builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0163 starttime: 1455907648.59 results: success (0) buildid: 20160219090024 builduid: a3a2d07138cf4393ae7cfc578dd79695 revision: 8b65dd9aa149cd88bb39e6eddfa47a5ed8705055 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.588430) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.592033) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.592384) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.005405 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.616358) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.616669) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.770606) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.770921) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005781 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.795303) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.795704) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.796154) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:28.796478) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-02-19 10:47:28-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 8.32M=0.001s 2016-02-19 10:47:29 (8.32 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.216909 ========= master_lag: 0.12 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:29.130198) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:29.130515) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.020391 ========= master_lag: 0.13 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:29.276583) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-02-19 10:47:29.276933) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 8b65dd9aa149cd88bb39e6eddfa47a5ed8705055 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 8b65dd9aa149cd88bb39e6eddfa47a5ed8705055 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-02-19 10:47:29,359 truncating revision to first 12 chars 2016-02-19 10:47:29,359 Setting DEBUG logging. 2016-02-19 10:47:29,359 attempt 1/10 2016-02-19 10:47:29,359 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/8b65dd9aa149?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-19 10:47:30,292 unpacking tar archive at: fx-team-8b65dd9aa149/testing/mozharness/ program finished with exit code 0 elapsedTime=1.176538 ========= master_lag: 0.29 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-02-19 10:47:30.745777) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:30.746137) ========= echo 8b65dd9aa149cd88bb39e6eddfa47a5ed8705055 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'8b65dd9aa149cd88bb39e6eddfa47a5ed8705055'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 8b65dd9aa149cd88bb39e6eddfa47a5ed8705055 program finished with exit code 0 elapsedTime=0.005537 script_repo_revision: '8b65dd9aa149cd88bb39e6eddfa47a5ed8705055' ========= master_lag: 0.26 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:31.006963) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:31.007282) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-19 10:47:31.032424) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2016-02-19 10:47:31.032742) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 10:47:31 INFO - MultiFileLogger online at 20160219 10:47:31 in /builds/slave/test 10:47:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 10:47:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:47:31 INFO - {'append_to_log': False, 10:47:31 INFO - 'base_work_dir': '/builds/slave/test', 10:47:31 INFO - 'blob_upload_branch': 'Fx-Team', 10:47:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:47:31 INFO - 'branch': 'Fx-Team', 10:47:31 INFO - 'buildbot_json_path': 'buildprops.json', 10:47:31 INFO - 'config_files': ('talos/mac_config.py',), 10:47:31 INFO - 'default_actions': ('clobber', 10:47:31 INFO - 'read-buildbot-config', 10:47:31 INFO - 'download-and-extract', 10:47:31 INFO - 'populate-webroot', 10:47:31 INFO - 'create-virtualenv', 10:47:31 INFO - 'install', 10:47:31 INFO - 'run-tests'), 10:47:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:47:31 INFO - 'download_minidump_stackwalk': True, 10:47:31 INFO - 'download_symbols': 'ondemand', 10:47:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:47:31 INFO - 'tooltool.py': '/tools/tooltool.py', 10:47:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:47:31 INFO - '/tools/misc-python/virtualenv.py')}, 10:47:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:47:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:47:31 INFO - 'installer_path': 'installer.exe', 10:47:31 INFO - 'log_level': 'info', 10:47:31 INFO - 'log_name': 'talos', 10:47:31 INFO - 'log_to_console': True, 10:47:31 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 10:47:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 10:47:31 INFO - 'opt_config_files': (), 10:47:31 INFO - 'pip_index': False, 10:47:31 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:47:31 INFO - 'cmd': ('bash', 10:47:31 INFO - '-c', 10:47:31 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:47:31 INFO - 'enabled': True, 10:47:31 INFO - 'halt_on_failure': False, 10:47:31 INFO - 'name': 'check_screen_resolution'},), 10:47:31 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:47:31 INFO - 'cmd': ('bash', 10:47:31 INFO - '-c', 10:47:31 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:47:31 INFO - 'enabled': True, 10:47:31 INFO - 'halt_on_failure': False, 10:47:31 INFO - 'name': 'check_screen_resolution'},), 10:47:31 INFO - 'run_cmd_checks_enabled': True, 10:47:31 INFO - 'sps_profile': False, 10:47:31 INFO - 'sps_profile_interval': 0, 10:47:31 INFO - 'suite': 'dromaeojs', 10:47:31 INFO - 'system_bits': '32', 10:47:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:47:31 INFO - 'title': 't-yosemite-r7-0163', 10:47:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:47:31 INFO - 'use_talos_json': True, 10:47:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:47:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:47:31 INFO - 'work_dir': 'build'} 10:47:31 INFO - ##### 10:47:31 INFO - ##### Running clobber step. 10:47:31 INFO - ##### 10:47:31 INFO - Running pre-action listener: _resource_record_pre_action 10:47:31 INFO - Running main action method: clobber 10:47:31 INFO - rmtree: /builds/slave/test/build 10:47:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:47:32 INFO - Running post-action listener: _resource_record_post_action 10:47:32 INFO - ##### 10:47:32 INFO - ##### Running read-buildbot-config step. 10:47:32 INFO - ##### 10:47:32 INFO - Running pre-action listener: _resource_record_pre_action 10:47:32 INFO - Running main action method: read_buildbot_config 10:47:32 INFO - Using buildbot properties: 10:47:32 INFO - { 10:47:32 INFO - "project": "", 10:47:32 INFO - "product": "firefox", 10:47:32 INFO - "script_repo_revision": "production", 10:47:32 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 10:47:32 INFO - "repository": "", 10:47:32 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 10:47:32 INFO - "buildid": "20160219090024", 10:47:32 INFO - "pgo_build": "False", 10:47:32 INFO - "basedir": "/builds/slave/test", 10:47:32 INFO - "buildnumber": 394, 10:47:32 INFO - "slavename": "t-yosemite-r7-0163", 10:47:32 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 10:47:32 INFO - "platform": "yosemite_r7", 10:47:32 INFO - "scheduler": "tests-fx-team-macosx64-talos", 10:47:32 INFO - "branch": "fx-team", 10:47:32 INFO - "repo_path": "integration/fx-team", 10:47:32 INFO - "revision": "8b65dd9aa149cd88bb39e6eddfa47a5ed8705055", 10:47:32 INFO - "stage_platform": "macosx64", 10:47:32 INFO - "builduid": "a3a2d07138cf4393ae7cfc578dd79695", 10:47:32 INFO - "slavebuilddir": "test" 10:47:32 INFO - } 10:47:32 INFO - Found installer url https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg. 10:47:32 INFO - Running post-action listener: _resource_record_post_action 10:47:32 INFO - ##### 10:47:32 INFO - ##### Running download-and-extract step. 10:47:32 INFO - ##### 10:47:32 INFO - Running pre-action listener: _resource_record_pre_action 10:47:32 INFO - Running main action method: download_and_extract 10:47:32 INFO - mkdir: /builds/slave/test/build/tests 10:47:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:32 INFO - https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 10:47:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/test_packages.json 10:47:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/test_packages.json 10:47:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 10:47:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 10:47:35 INFO - Downloaded 1277 bytes. 10:47:35 INFO - Reading from file /builds/slave/test/build/test_packages.json 10:47:35 INFO - Using the following test package requirements: 10:47:35 INFO - {u'common': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:47:35 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:47:35 INFO - u'firefox-47.0a1.en-US.mac.cppunittest.tests.zip'], 10:47:35 INFO - u'gtest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:47:35 INFO - u'firefox-47.0a1.en-US.mac.gtest.tests.zip'], 10:47:35 INFO - u'jittest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:47:35 INFO - u'jsshell-mac.zip'], 10:47:35 INFO - u'mochitest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:47:35 INFO - u'firefox-47.0a1.en-US.mac.mochitest.tests.zip'], 10:47:35 INFO - u'mozbase': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:47:35 INFO - u'reftest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:47:35 INFO - u'firefox-47.0a1.en-US.mac.reftest.tests.zip'], 10:47:35 INFO - u'talos': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:47:35 INFO - u'firefox-47.0a1.en-US.mac.talos.tests.zip'], 10:47:35 INFO - u'web-platform': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:47:35 INFO - u'firefox-47.0a1.en-US.mac.web-platform.tests.zip'], 10:47:35 INFO - u'webapprt': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:47:35 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:47:35 INFO - u'firefox-47.0a1.en-US.mac.xpcshell.tests.zip']} 10:47:35 INFO - Downloading packages: [u'firefox-47.0a1.en-US.mac.common.tests.zip'] for test suite category: common 10:47:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:35 INFO - https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 10:47:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:47:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:47:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:47:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip'}, attempt #1 10:47:36 INFO - Downloaded 17809117 bytes. 10:47:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:47:36 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 10:47:39 INFO - Return code: 0 10:47:39 INFO - Downloading packages: [u'firefox-47.0a1.en-US.mac.common.tests.zip', u'firefox-47.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 10:47:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:39 INFO - https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 10:47:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:47:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:47:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:47:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip'}, attempt #1 10:47:40 INFO - Downloaded 17809117 bytes. 10:47:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:47:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 10:47:44 INFO - Return code: 0 10:47:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:44 INFO - https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 10:47:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:47:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:47:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:47:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip'}, attempt #1 10:47:45 INFO - Downloaded 10707015 bytes. 10:47:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:47:45 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 10:47:45 INFO - Return code: 0 10:47:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:45 INFO - https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 10:47:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:47:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:47:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg 10:47:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg'}, attempt #1 10:47:48 INFO - Downloaded 111232268 bytes. 10:47:48 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:47:48 INFO - mkdir: /builds/slave/test/properties 10:47:48 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:47:48 INFO - Writing to file /builds/slave/test/properties/build_url 10:47:48 INFO - Contents: 10:47:48 INFO - build_url:https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:47:50 INFO - Running post-action listener: _resource_record_post_action 10:47:50 INFO - Running post-action listener: set_extra_try_arguments 10:47:50 INFO - ##### 10:47:50 INFO - ##### Running populate-webroot step. 10:47:50 INFO - ##### 10:47:50 INFO - Running pre-action listener: _resource_record_pre_action 10:47:50 INFO - Running main action method: populate_webroot 10:47:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:47:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:47:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:47:50 INFO - '--tppagecycles', 10:47:50 INFO - '7'], 10:47:50 INFO - 'tests': ['tsvgm']}}, 10:47:50 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 10:47:50 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:47:50 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 10:47:50 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:47:50 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:47:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:47:50 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:47:50 INFO - 'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:47:50 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:47:50 INFO - 'tests': ['damp', 'tps']}, 10:47:50 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:47:50 INFO - 'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['damp', 'tps']}, 10:47:50 INFO - 'g3': {'tests': ['dromaeo_dom']}, 10:47:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:47:50 INFO - 'other': {'tests': ['a11yr', 10:47:50 INFO - 'ts_paint', 10:47:50 INFO - 'tpaint', 10:47:50 INFO - 'sessionrestore', 10:47:50 INFO - 'sessionrestore_no_auto_restore']}, 10:47:50 INFO - 'other-e10s': {'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['a11yr', 10:47:50 INFO - 'ts_paint', 10:47:50 INFO - 'tpaint', 10:47:50 INFO - 'sessionrestore', 10:47:50 INFO - 'sessionrestore_no_auto_restore']}, 10:47:50 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['a11yr', 10:47:50 INFO - 'ts_paint', 10:47:50 INFO - 'tpaint', 10:47:50 INFO - 'sessionrestore', 10:47:50 INFO - 'sessionrestore_no_auto_restore']}, 10:47:50 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['a11yr', 10:47:50 INFO - 'ts_paint', 10:47:50 INFO - 'tpaint', 10:47:50 INFO - 'sessionrestore', 10:47:50 INFO - 'sessionrestore_no_auto_restore']}, 10:47:50 INFO - 'other_l64': {'tests': ['a11yr', 10:47:50 INFO - 'ts_paint', 10:47:50 INFO - 'tpaint', 10:47:50 INFO - 'sessionrestore', 10:47:50 INFO - 'sessionrestore_no_auto_restore']}, 10:47:50 INFO - 'other_nol64': {'tests': ['a11yr', 10:47:50 INFO - 'ts_paint', 10:47:50 INFO - 'tpaint', 10:47:50 INFO - 'sessionrestore', 10:47:50 INFO - 'sessionrestore_no_auto_restore']}, 10:47:50 INFO - 'svgr': {'tests': ['tsvgx', 10:47:50 INFO - 'tsvgr_opacity', 10:47:50 INFO - 'tart', 10:47:50 INFO - 'tscrollx', 10:47:50 INFO - 'cart']}, 10:47:50 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['tsvgx', 10:47:50 INFO - 'tsvgr_opacity', 10:47:50 INFO - 'tart', 10:47:50 INFO - 'tscrollx', 10:47:50 INFO - 'cart']}, 10:47:50 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:47:50 INFO - 'tests': ['tp5o']}, 10:47:50 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:47:50 INFO - 'talos_options': ['--e10s'], 10:47:50 INFO - 'tests': ['tp5o']}, 10:47:50 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:47:50 INFO - 'talos_options': ['--xperf_path', 10:47:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:47:50 INFO - 'tests': ['tp5n']}, 10:47:50 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:47:50 INFO - 'talos_options': ['--e10s', 10:47:50 INFO - '--xperf_path', 10:47:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:47:50 INFO - 'tests': ['tp5n']}}, 10:47:50 INFO - 'talos.zip': {'path': '', 10:47:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:47:50 INFO - Running post-action listener: _resource_record_post_action 10:47:50 INFO - ##### 10:47:50 INFO - ##### Running create-virtualenv step. 10:47:50 INFO - ##### 10:47:50 INFO - Running pre-action listener: _resource_record_pre_action 10:47:50 INFO - Running main action method: create_virtualenv 10:47:50 INFO - Creating virtualenv /builds/slave/test/build/venv 10:47:50 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 10:47:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:47:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:47:50 INFO - Using real prefix '/tools/python27' 10:47:50 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:47:51 INFO - Installing distribute.............................................................................................................................................................................................done. 10:47:53 INFO - Installing pip.................done. 10:47:54 INFO - Return code: 0 10:47:54 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:47:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:47:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:47:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:47:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:47:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:47:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 10:47:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 10:47:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:47:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:47:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:47:54 INFO - 'HOME': '/Users/cltbld', 10:47:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:47:54 INFO - 'LOGNAME': 'cltbld', 10:47:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:47:54 INFO - 'MOZ_NO_REMOTE': '1', 10:47:54 INFO - 'NO_EM_RESTART': '1', 10:47:54 INFO - 'PAGER': '/bin/cat', 10:47:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:47:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:47:54 INFO - 'PWD': '/builds/slave/test', 10:47:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:47:54 INFO - 'SHELL': '/bin/bash', 10:47:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:47:54 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:47:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:47:54 INFO - 'USER': 'cltbld', 10:47:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:47:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:47:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:47:54 INFO - 'XPC_FLAGS': '0x0', 10:47:54 INFO - 'XPC_SERVICE_NAME': '0', 10:47:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:47:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:47:54 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 10:47:54 INFO - Cleaning up... 10:47:54 INFO - Return code: 0 10:47:54 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 10:47:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:47:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:47:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:47:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:47:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:47:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 10:47:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 10:47:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:47:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:47:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:47:54 INFO - 'HOME': '/Users/cltbld', 10:47:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:47:54 INFO - 'LOGNAME': 'cltbld', 10:47:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:47:54 INFO - 'MOZ_NO_REMOTE': '1', 10:47:54 INFO - 'NO_EM_RESTART': '1', 10:47:54 INFO - 'PAGER': '/bin/cat', 10:47:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:47:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:47:54 INFO - 'PWD': '/builds/slave/test', 10:47:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:47:54 INFO - 'SHELL': '/bin/bash', 10:47:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:47:54 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:47:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:47:54 INFO - 'USER': 'cltbld', 10:47:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:47:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:47:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:47:54 INFO - 'XPC_FLAGS': '0x0', 10:47:54 INFO - 'XPC_SERVICE_NAME': '0', 10:47:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:47:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:47:54 INFO - Downloading/unpacking psutil>=0.7.1 10:47:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:47:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:47:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:47:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:47:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:47:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:47:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:47:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:47:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:47:57 INFO - Installing collected packages: psutil 10:47:57 INFO - Running setup.py install for psutil 10:47:57 INFO - building 'psutil._psutil_osx' extension 10:47:57 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 10:47:57 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 10:47:57 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 10:47:57 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 10:47:57 INFO - building 'psutil._psutil_posix' extension 10:47:57 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 10:47:57 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 10:47:57 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 10:47:57 INFO - ^ 10:47:58 INFO - 1 warning generated. 10:47:58 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 10:47:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:47:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:47:58 INFO - Successfully installed psutil 10:47:58 INFO - Cleaning up... 10:47:58 INFO - Return code: 0 10:47:58 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 10:47:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:47:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:47:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:47:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:47:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:47:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:47:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 10:47:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 10:47:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:47:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:47:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:47:58 INFO - 'HOME': '/Users/cltbld', 10:47:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:47:58 INFO - 'LOGNAME': 'cltbld', 10:47:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:47:58 INFO - 'MOZ_NO_REMOTE': '1', 10:47:58 INFO - 'NO_EM_RESTART': '1', 10:47:58 INFO - 'PAGER': '/bin/cat', 10:47:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:47:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:47:58 INFO - 'PWD': '/builds/slave/test', 10:47:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:47:58 INFO - 'SHELL': '/bin/bash', 10:47:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:47:58 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:47:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:47:58 INFO - 'USER': 'cltbld', 10:47:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:47:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:47:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:47:58 INFO - 'XPC_FLAGS': '0x0', 10:47:58 INFO - 'XPC_SERVICE_NAME': '0', 10:47:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:47:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:47:58 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 10:47:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:47:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:47:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:47:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:47:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:47:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:00 INFO - Downloading mozsystemmonitor-0.0.tar.gz 10:48:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 10:48:00 INFO - Installing collected packages: mozsystemmonitor 10:48:00 INFO - Running setup.py install for mozsystemmonitor 10:48:01 INFO - Successfully installed mozsystemmonitor 10:48:01 INFO - Cleaning up... 10:48:01 INFO - Return code: 0 10:48:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:48:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:48:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:48:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:48:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:48:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:48:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:48:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:48:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:48:01 INFO - 'HOME': '/Users/cltbld', 10:48:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:48:01 INFO - 'LOGNAME': 'cltbld', 10:48:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:48:01 INFO - 'MOZ_NO_REMOTE': '1', 10:48:01 INFO - 'NO_EM_RESTART': '1', 10:48:01 INFO - 'PAGER': '/bin/cat', 10:48:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:48:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:48:01 INFO - 'PWD': '/builds/slave/test', 10:48:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:48:01 INFO - 'SHELL': '/bin/bash', 10:48:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:48:01 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:48:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:48:01 INFO - 'USER': 'cltbld', 10:48:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:48:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:48:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:48:01 INFO - 'XPC_FLAGS': '0x0', 10:48:01 INFO - 'XPC_SERVICE_NAME': '0', 10:48:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:48:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:48:01 INFO - Downloading/unpacking blobuploader==1.2.4 10:48:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:03 INFO - Downloading blobuploader-1.2.4.tar.gz 10:48:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:48:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:48:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:48:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:04 INFO - Downloading docopt-0.6.1.tar.gz 10:48:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:48:04 INFO - Installing collected packages: blobuploader, requests, docopt 10:48:04 INFO - Running setup.py install for blobuploader 10:48:05 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:48:05 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:48:05 INFO - Running setup.py install for requests 10:48:05 INFO - Running setup.py install for docopt 10:48:05 INFO - Successfully installed blobuploader requests docopt 10:48:05 INFO - Cleaning up... 10:48:05 INFO - Return code: 0 10:48:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:48:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:48:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:48:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:48:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 10:48:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:48:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:48:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:48:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:48:05 INFO - 'HOME': '/Users/cltbld', 10:48:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:48:05 INFO - 'LOGNAME': 'cltbld', 10:48:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:48:05 INFO - 'MOZ_NO_REMOTE': '1', 10:48:05 INFO - 'NO_EM_RESTART': '1', 10:48:05 INFO - 'PAGER': '/bin/cat', 10:48:05 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:48:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:48:05 INFO - 'PWD': '/builds/slave/test', 10:48:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:48:05 INFO - 'SHELL': '/bin/bash', 10:48:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:48:05 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:48:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:48:05 INFO - 'USER': 'cltbld', 10:48:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:48:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:48:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:48:05 INFO - 'XPC_FLAGS': '0x0', 10:48:05 INFO - 'XPC_SERVICE_NAME': '0', 10:48:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:48:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-hzSc_C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-AcyHii-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-bO8GSe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-6mvd00-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-XcxtkD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-EKLINu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-FmcD5j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-bPJtnK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:48:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:48:06 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-FRtKvJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:48:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:48:07 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-wvownG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:48:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:48:07 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-ViXfpC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:48:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:48:07 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-321ozH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:48:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:48:07 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-nOgOkm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:48:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:48:07 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-heY4nJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:48:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:48:07 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-uXFFNB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:48:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:48:07 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-Bud1UX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:48:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:48:07 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-9b18zv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:48:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:48:07 INFO - Running setup.py install for manifestparser 10:48:07 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:48:07 INFO - Running setup.py install for mozcrash 10:48:08 INFO - Running setup.py install for mozdebug 10:48:08 INFO - Running setup.py install for mozdevice 10:48:08 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:48:08 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:48:08 INFO - Running setup.py install for mozfile 10:48:08 INFO - Running setup.py install for mozhttpd 10:48:08 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:48:08 INFO - Running setup.py install for mozinfo 10:48:08 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:48:08 INFO - Running setup.py install for mozInstall 10:48:09 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Running setup.py install for mozleak 10:48:09 INFO - Running setup.py install for mozlog 10:48:09 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Running setup.py install for moznetwork 10:48:09 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Running setup.py install for mozprocess 10:48:09 INFO - Running setup.py install for mozprofile 10:48:09 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Running setup.py install for mozrunner 10:48:09 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:48:09 INFO - Running setup.py install for mozscreenshot 10:48:10 INFO - Running setup.py install for moztest 10:48:10 INFO - Running setup.py install for mozversion 10:48:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:48:10 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:48:10 INFO - Cleaning up... 10:48:10 INFO - Return code: 0 10:48:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:48:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:48:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:48:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:48:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 10:48:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:48:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:48:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:48:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:48:10 INFO - 'HOME': '/Users/cltbld', 10:48:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:48:10 INFO - 'LOGNAME': 'cltbld', 10:48:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:48:10 INFO - 'MOZ_NO_REMOTE': '1', 10:48:10 INFO - 'NO_EM_RESTART': '1', 10:48:10 INFO - 'PAGER': '/bin/cat', 10:48:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:48:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:48:10 INFO - 'PWD': '/builds/slave/test', 10:48:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:48:10 INFO - 'SHELL': '/bin/bash', 10:48:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:48:10 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:48:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:48:10 INFO - 'USER': 'cltbld', 10:48:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:48:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:48:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:48:10 INFO - 'XPC_FLAGS': '0x0', 10:48:10 INFO - 'XPC_SERVICE_NAME': '0', 10:48:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:48:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:48:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:48:10 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-MQRf_9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:48:10 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 10:48:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:48:10 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-8ujski-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:48:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:48:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:48:10 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-c4LKvG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-zT9zG6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-0XzhyG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-JCcQrM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-P0aerr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-1DSlUW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-ZwSAhL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-qL67wp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-WNJLBE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:48:11 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-nH_p8S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:48:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 10:48:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:48:12 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-peC0IC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 10:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:48:12 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-pn7Dke-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 10:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:48:12 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-BBlu02-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 10:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:48:12 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-BF7LSU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 10:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:48:12 INFO - Running setup.py (path:/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/pip-lXX_YM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:48:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:48:12 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:48:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:14 INFO - Downloading blessings-1.6.tar.gz 10:48:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:48:14 INFO - Installing collected packages: blessings 10:48:14 INFO - Running setup.py install for blessings 10:48:15 INFO - Successfully installed blessings 10:48:15 INFO - Cleaning up... 10:48:15 INFO - Return code: 0 10:48:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:48:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:48:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:48:15 INFO - Reading from file tmpfile_stdout 10:48:15 INFO - Current package versions: 10:48:15 INFO - blessings == 1.6 10:48:15 INFO - blobuploader == 1.2.4 10:48:15 INFO - docopt == 0.6.1 10:48:15 INFO - manifestparser == 1.1 10:48:15 INFO - mozInstall == 1.12 10:48:15 INFO - mozcrash == 0.16 10:48:15 INFO - mozdebug == 0.1 10:48:15 INFO - mozdevice == 0.48 10:48:15 INFO - mozfile == 1.2 10:48:15 INFO - mozhttpd == 0.7 10:48:15 INFO - mozinfo == 0.9 10:48:15 INFO - mozleak == 0.1 10:48:15 INFO - mozlog == 3.1 10:48:15 INFO - moznetwork == 0.27 10:48:15 INFO - mozprocess == 0.22 10:48:15 INFO - mozprofile == 0.28 10:48:15 INFO - mozrunner == 6.11 10:48:15 INFO - mozscreenshot == 0.1 10:48:15 INFO - mozsystemmonitor == 0.0 10:48:15 INFO - moztest == 0.7 10:48:15 INFO - mozversion == 1.4 10:48:15 INFO - psutil == 3.1.1 10:48:15 INFO - requests == 1.2.3 10:48:15 INFO - wsgiref == 0.1.2 10:48:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:48:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:48:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:48:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:48:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 10:48:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:48:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:48:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:48:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:48:15 INFO - 'HOME': '/Users/cltbld', 10:48:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:48:15 INFO - 'LOGNAME': 'cltbld', 10:48:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:48:15 INFO - 'MOZ_NO_REMOTE': '1', 10:48:15 INFO - 'NO_EM_RESTART': '1', 10:48:15 INFO - 'PAGER': '/bin/cat', 10:48:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:48:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:48:15 INFO - 'PWD': '/builds/slave/test', 10:48:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:48:15 INFO - 'SHELL': '/bin/bash', 10:48:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:48:15 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:48:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:48:15 INFO - 'USER': 'cltbld', 10:48:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:48:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:48:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:48:15 INFO - 'XPC_FLAGS': '0x0', 10:48:15 INFO - 'XPC_SERVICE_NAME': '0', 10:48:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:48:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:48:15 INFO - Cleaning up... 10:48:15 INFO - Return code: 0 10:48:15 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:48:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:48:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:48:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:48:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 10:48:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 10:48:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:48:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:48:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:48:15 INFO - 'HOME': '/Users/cltbld', 10:48:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:48:15 INFO - 'LOGNAME': 'cltbld', 10:48:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:48:15 INFO - 'MOZ_NO_REMOTE': '1', 10:48:15 INFO - 'NO_EM_RESTART': '1', 10:48:15 INFO - 'PAGER': '/bin/cat', 10:48:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:48:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:48:15 INFO - 'PWD': '/builds/slave/test', 10:48:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:48:15 INFO - 'SHELL': '/bin/bash', 10:48:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:48:15 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:48:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:48:15 INFO - 'USER': 'cltbld', 10:48:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:48:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:48:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:48:15 INFO - 'XPC_FLAGS': '0x0', 10:48:15 INFO - 'XPC_SERVICE_NAME': '0', 10:48:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:48:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:48:15 INFO - Downloading/unpacking jsonschema 10:48:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:18 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:48:18 INFO - Downloading/unpacking functools32 (from jsonschema) 10:48:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:18 INFO - Downloading functools32-3.2.3-2.tar.gz 10:48:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:48:18 INFO - warning: no files found matching '*.txt' 10:48:18 INFO - no previously-included directories found matching 'build' 10:48:18 INFO - no previously-included directories found matching 'dist' 10:48:18 INFO - no previously-included directories found matching '.git*' 10:48:18 INFO - Installing collected packages: jsonschema, functools32 10:48:18 INFO - Running setup.py install for functools32 10:48:18 INFO - warning: no files found matching '*.txt' 10:48:18 INFO - no previously-included directories found matching 'build' 10:48:18 INFO - no previously-included directories found matching 'dist' 10:48:18 INFO - no previously-included directories found matching '.git*' 10:48:18 INFO - Successfully installed jsonschema functools32 10:48:18 INFO - Cleaning up... 10:48:19 INFO - Return code: 0 10:48:19 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 10:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:48:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:48:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:48:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c72fa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c7374c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa601d9f530>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:48:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 10:48:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 10:48:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:48:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:48:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:48:19 INFO - 'HOME': '/Users/cltbld', 10:48:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:48:19 INFO - 'LOGNAME': 'cltbld', 10:48:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:48:19 INFO - 'MOZ_NO_REMOTE': '1', 10:48:19 INFO - 'NO_EM_RESTART': '1', 10:48:19 INFO - 'PAGER': '/bin/cat', 10:48:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:48:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:48:19 INFO - 'PWD': '/builds/slave/test', 10:48:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:48:19 INFO - 'SHELL': '/bin/bash', 10:48:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:48:19 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:48:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:48:19 INFO - 'USER': 'cltbld', 10:48:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:48:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:48:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:48:19 INFO - 'XPC_FLAGS': '0x0', 10:48:19 INFO - 'XPC_SERVICE_NAME': '0', 10:48:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:48:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:48:19 INFO - Downloading/unpacking flake8 10:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:21 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 10:48:21 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 10:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:22 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 10:48:22 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 10:48:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:22 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 10:48:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:48:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:48:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:48:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 10:48:22 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:48:22 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:48:22 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:48:22 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:48:22 INFO - no previously-included directories found matching 'docs/_build' 10:48:22 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 10:48:22 INFO - Running setup.py install for pep8 10:48:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:48:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:48:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:48:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:48:23 INFO - no previously-included directories found matching 'docs/_build' 10:48:23 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 10:48:23 INFO - Successfully installed flake8 mccabe pyflakes pep8 10:48:23 INFO - Cleaning up... 10:48:23 INFO - Return code: 0 10:48:23 INFO - Running post-action listener: _resource_record_post_action 10:48:23 INFO - Running post-action listener: _start_resource_monitoring 10:48:23 INFO - Starting resource monitoring. 10:48:23 INFO - ##### 10:48:23 INFO - ##### Running install step. 10:48:23 INFO - ##### 10:48:23 INFO - Running pre-action listener: _resource_record_pre_action 10:48:23 INFO - Running main action method: install 10:48:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:48:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:48:23 INFO - Reading from file tmpfile_stdout 10:48:23 INFO - Detecting whether we're running mozinstall >=1.0... 10:48:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:48:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:48:23 INFO - Reading from file tmpfile_stdout 10:48:23 INFO - Output received: 10:48:23 INFO - Usage: mozinstall [options] installer 10:48:23 INFO - Options: 10:48:23 INFO - -h, --help show this help message and exit 10:48:23 INFO - -d DEST, --destination=DEST 10:48:23 INFO - Directory to install application into. [default: 10:48:23 INFO - "/builds/slave/test"] 10:48:23 INFO - --app=APP Application being installed. [default: firefox] 10:48:23 INFO - mkdir: /builds/slave/test/build/application 10:48:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 10:48:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 10:48:57 INFO - Reading from file tmpfile_stdout 10:48:57 INFO - Output received: 10:48:57 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 10:48:57 INFO - Running post-action listener: _resource_record_post_action 10:48:57 INFO - ##### 10:48:57 INFO - ##### Running run-tests step. 10:48:57 INFO - ##### 10:48:57 INFO - Running pre-action listener: _resource_record_pre_action 10:48:57 INFO - Running main action method: run_tests 10:48:57 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:48:57 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:48:57 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:48:57 INFO - 2016-02-19 10:48:57.868 screenresolution[2570:19789] starting screenresolution argv=screenresolution get 10:48:57 INFO - 2016-02-19 10:48:57.871 screenresolution[2570:19789] Display 0: 1600x1200x32@60 10:48:57 INFO - 2016-02-19 10:48:57.877 screenresolution[2571:19791] starting screenresolution argv=screenresolution list 10:48:57 INFO - Available Modes on Display 0 10:48:57 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:48:57 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:48:57 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:48:57 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:48:58 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:48:58 INFO - Intel Iris: 10:48:58 INFO - Chipset Model: Intel Iris 10:48:58 INFO - Type: GPU 10:48:58 INFO - Bus: Built-In 10:48:58 INFO - VRAM (Dynamic, Max): 1536 MB 10:48:58 INFO - Vendor: Intel (0x8086) 10:48:58 INFO - Device ID: 0x0a2e 10:48:58 INFO - Revision ID: 0x0009 10:48:58 INFO - Displays: 10:48:58 INFO - Display: 10:48:58 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:48:58 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:48:58 INFO - Display Serial Number: 1600x1200 60 10:48:58 INFO - Main Display: Yes 10:48:58 INFO - Mirror: Off 10:48:58 INFO - Online: Yes 10:48:58 INFO - Rotation: Supported 10:48:58 INFO - Return code: 0 10:48:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:48:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:48:58 INFO - Python 2.7.3 10:48:58 INFO - Return code: 0 10:48:58 INFO - grabbing minidump binary from tooltool 10:48:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:48:58 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5d3d30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c3f7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cab20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:48:58 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 10:48:58 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 10:48:58 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:48:58 INFO - Return code: 0 10:48:58 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 10:48:58 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:48:58 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:48:58 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 10:48:58 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:48:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 10:48:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 10:48:59 INFO - Return code: 0 10:48:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0163', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 10:48:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0163 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 10:48:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.XM5J8ekcNO/Render', 10:48:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:48:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:48:59 INFO - 'HOME': '/Users/cltbld', 10:48:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:48:59 INFO - 'LOGNAME': 'cltbld', 10:48:59 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:48:59 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 10:48:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:48:59 INFO - 'MOZ_NO_REMOTE': '1', 10:48:59 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:48:59 INFO - 'NO_EM_RESTART': '1', 10:48:59 INFO - 'PAGER': '/bin/cat', 10:48:59 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:48:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:48:59 INFO - 'PWD': '/builds/slave/test', 10:48:59 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:48:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:48:59 INFO - 'SHELL': '/bin/bash', 10:48:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners', 10:48:59 INFO - 'TMPDIR': '/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/', 10:48:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:48:59 INFO - 'USER': 'cltbld', 10:48:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:48:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:48:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:48:59 INFO - 'XPC_FLAGS': '0x0', 10:48:59 INFO - 'XPC_SERVICE_NAME': '0', 10:48:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:48:59 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0163', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 10:48:59 INFO - mozversion application_buildid: 20160219090024 10:48:59 INFO - mozversion application_changeset: 8b65dd9aa149cd88bb39e6eddfa47a5ed8705055 10:48:59 INFO - mozversion application_display_name: Nightly 10:48:59 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:48:59 INFO - mozversion application_name: Firefox 10:48:59 INFO - mozversion application_remotingname: firefox 10:48:59 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 10:48:59 INFO - mozversion application_vendor: Mozilla 10:48:59 INFO - mozversion application_version: 47.0a1 10:48:59 INFO - mozversion platform_buildid: 20160219090024 10:48:59 INFO - mozversion platform_changeset: 8b65dd9aa149cd88bb39e6eddfa47a5ed8705055 10:48:59 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 10:48:59 INFO - mozversion platform_version: 47.0a1 10:48:59 INFO - using testdate: 1455907739 10:48:59 INFO - actual date: 1455907739 10:48:59 INFO - starting webserver on 'localhost:50292' 10:48:59 INFO - SUITE-START | Running 2 tests 10:48:59 INFO - TEST-START | dromaeo_css 10:48:59 INFO - operating with platform_type : mac_ 10:48:59 INFO - Initialising browser for dromaeo_css test... 10:48:59 INFO - TEST-INFO | started process 2589 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/tmpoebh6v/profile http://localhost:50292/getInfo.html) 10:49:01 INFO - PROCESS | 2589 | __metrics Screen width/height:1600/1200 10:49:01 INFO - PROCESS | 2589 | colorDepth:24 10:49:01 INFO - PROCESS | 2589 | Browser inner width/height: 1024/689 10:49:01 INFO - PROCESS | 2589 | __metrics 10:49:02 INFO - PROCESS | 2589 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 668: Error: Phase "quit-application-granted is finished, it is too late to register completion condition "SessionStore: flushing all windows" 10:49:02 INFO - PROCESS | 2589 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:49:02 INFO - TEST-INFO | 2589: exit 0 10:49:02 INFO - Browser initialized. 10:49:02 INFO - Running cycle 1/1 for dromaeo_css test... 10:49:02 INFO - TEST-INFO | started process 2592 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/tmpoebh6v/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:49:14 INFO - PROCESS | 2592 | RSS: Main: 244252672 10:49:14 INFO - PROCESS | 2592 | 10:50:05 INFO - PROCESS | 2592 | 1455907805704 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 10:52:15 INFO - PROCESS | 2592 | Cycle 1(1): loaded http://localhost:50292/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50292/tests/dromaeo/cssquery-ext.html) 10:52:17 INFO - PROCESS | 2592 | RSS: Main: 354476032 10:52:17 INFO - PROCESS | 2592 | 10:55:19 INFO - PROCESS | 2592 | Cycle 1(1): loaded http://localhost:50292/tests/dromaeo/cssquery-ext.html (next: http://localhost:50292/tests/dromaeo/cssquery-jquery.html) 10:55:20 INFO - PROCESS | 2592 | RSS: Main: 372056064 10:55:20 INFO - PROCESS | 2592 | 10:58:22 INFO - PROCESS | 2592 | Cycle 1(1): loaded http://localhost:50292/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50292/tests/dromaeo/cssquery-mootools.html) 10:58:23 INFO - PROCESS | 2592 | RSS: Main: 378335232 10:58:23 INFO - PROCESS | 2592 | 11:01:25 INFO - PROCESS | 2592 | Cycle 1(1): loaded http://localhost:50292/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50292/tests/dromaeo/cssquery-prototype.html) 11:01:25 INFO - PROCESS | 2592 | RSS: Main: 335884288 11:01:25 INFO - PROCESS | 2592 | 11:04:28 INFO - PROCESS | 2592 | Cycle 1(1): loaded http://localhost:50292/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50292/tests/dromaeo/cssquery-yui.html) 11:04:29 INFO - PROCESS | 2592 | RSS: Main: 338628608 11:04:29 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | Cycle 1(1): loaded http://localhost:50292/tests/dromaeo/cssquery-yui.html (next: http://localhost:50292/tests/dromaeo/cssquery-dojo.html) 11:07:32 INFO - PROCESS | 2592 | RSS: Main: 389402624 11:07:32 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | __start_tp_report 11:07:32 INFO - PROCESS | 2592 | _x_x_mozilla_page_load 11:07:32 INFO - PROCESS | 2592 | _x_x_mozilla_page_load_details 11:07:32 INFO - PROCESS | 2592 | |i|pagename|runs| 11:07:32 INFO - PROCESS | 2592 | |0;dojo.html;3132.937341253175;3396.049106250249;3430.519727238187;3432.1591210153515;3475.3223121491305;5573.247611572437;5591.524720398771;5629.437056294374;5638.40796716345;5654.18014387914;5609.607327487078;5639.2668953036155;5668.036433806253;5757.856053598662;5763.0779075347955;5056.797728090872;5107.693538387699;5114.2072978688175;5146.871328216787;5225.2162175673575;5196.350456192976;5257.605679574028;5260.894782104356;5269.473052694738;5297.920531192035;5093.286939828427;5103.642745007851;5148.6910785353;5184.792608295664;5234.895302093975;4280.357946308048;4933.407991041062;5038.106459455023;5066.822661206877;5081.745912704387;4970.2793095001025;5000.849974500771;5010.749462526859;5048.747562621854;5085.237214417867;5437.619366644337;5545.972270138664;5570.415106413809;5574.275344205268;5665.716714164317;6212.0371342441995;6218.937810621881;6229.314775374705;6235.127082208494;6242.96878515609;5171.844844654666;6110.953680641517;6200;6281.152044473984;6290.21372328459;5767.942320576824;5814.534837213013;5823.941760582425;5870.060790273578;5873.236479257755;6279.686015699197;6280.968595157086;6302.621842689453;6313.43179113882;6313.905291420632;5842.328132264759;6062.969685151546;6064.848378790565;6066.848328791815;6080.604760690541;6138.416850399205;6199.659018753921;6202.1937148171355;6218.9378106218355;6231.4391704745885;6070.119832624245;6077.331493535796;6148.292946311142;6175.96912015446;6181.938180618226;6069.969650151809;6124.785632502841;6128.6171709010705;6130.918788798945;6188.350223226586;4848.806047758121;4852.902941941142;4864.513548645178;4886.511348865156;4888.364512613338;4364.803583838735;4380.342948557678;4387.232234359039;4388.1223755249075;4448.777561121996;5566.248556444828;5591.692456914828;5663.461971112738;5690.9430905690415;5713.428657134254;6029.276486821609;6034.24571928509;6072.908906366408;6080.939190608037;6108.877822443526;5477.698726569997;5484.424135465799;5491.2312276281355;5493.917591236134;5512.366077901012;5231.607629427808;5324.7870085196155;5360.383555891122;5382.91925621116;5408.378036525771;5219.243209734643;6253.74985000604;6254;6266.279377871603;6277.71750271248;5184.766685499086;6095.908561371494;6299.275583307978;6303.527235457267;6313.842153946004;5237.8428647140645;6221.657808820377;6234;6237.157983672146;6259.593126446766;6095.75616975316;6107.572469927062;6109.236345456818;6133;6163.660998645118;6132.171952247653;6149.323574406722;6220.906686399798;6268.404501572343;6270.372962703693;4797;5890.704045110069;6094.634321940698;6117.724702388314;6128.540359473147;5890.381509941394;6094.390560944047;6100.633961962297;6118.449339559283;6136.601120927304;5885.205497257815;5929.584929054925;5935.40645935403;5941.792037278848;6015;6002.519798416203;6055.122007308827;6058.697065146813;6064.848378790565;6075.149479073022;5810.709464526842;5889.263842019747;5907.586468947133;5926.7925622603;5932.762689492544 11:07:32 INFO - PROCESS | 2592 | |1;ext.html;458.2896510408867;486.5548023558444;490.3723234260147;561.8061619059499;577.9046457334538;28397.858010709944;37772.62227377729;38203.617963820354;38366.61633383665;38436.615633843685;40922.79538602303;41300;41310.17379652405;41399.379009314885;41435.37846932291;9539.284553658468;9792.755181120458;9797.26520510961;9805.901940980606;9807.117359437649;9568.617255309779;9734.367266127714;9735.75660608487;9736.026397360278;9737.415755054719;9688.806223875517;9865.556049977733;9870.851937220947;9893.802123957517;9906;9707.61169553217;9820.31257811957;9823.852642210373;9823.950880245624;9828.066333698287;7914.208579142098;9097.81804363909;9446.055394460567;9556.761080972961;9724.611015559369;39291;39675.40486892699;39691.60308396908;39753.60246397528;39761.60238397608;3347.146477648184;3374.6625337466303;3528.523649307362;3626.2566173934542;3772.4718539404507;28129.57805632917;28955;29064.70935290641;29409.705902941125;29942.95199668001;2730.863456827151;2737.3840885800737;2759.4894944435346;2893.7250961158657;2935.911922642324;473719;475544;475969;475990;476446;44143.779281104034;44916.3262551062;45182.32226516605;60300.69849650723;60620;36794;43259.26962921511;43796;44168.46652267811;44176.3373549397;15221.695566088616;15380.461683841011;15404.46084387041;15453.5363939082;15459.690806184039;12359.876401236052;12450.626481205578;12456.875431245753;12462.189957652723;12464.875351246554;14118.788218176736;14244;14297.571072867831;14313.85686143146;14347.139171649735;6303.842403939938;6338.239411270585;6341.55609107358;6386.584871983307;6399.520035997226;858.6007506509503;935.8876934767871;991.3605724307781;1041.286718597763;1055.3747229266996;29579.556306655417;29856.05935614178;30121;30195.547066794017;30652.92714754973;875.7363602865471;1051.3691784929135;1052.163529993657;1074.7581794096266;1177.735009622828;13937.58187254384;15892.364305427653;15902.920485397499;16179.05976759528;16570.337186512403;602353;604896;610109;610576;611676;58603;58924;59153.704231478565;59248.7037564818;59311.70344148252;1245.8068999305121;1311.9934400327936;1340.3566288181728;1439.6113049476792;1582.3907795498585;28287.15138545847;28472.145835624964;28962.420751585272;29009.854950725112;29081;40822;53818.730906346784;54974.90050199054;55034.72482637561;55047.174292386444;432546.8372658116;432994.3706192253;436079;437536;466393;40104.79947600243;40448.59551404566;40559.39160912648;40604.59395406008;40927.77216683504;44948.55051449444;45197.87005324893;45277;46299.53700462952;46488.767556162005;36340.636593633724;37263;38151;38470.23059538849;38471;36921.44617830789;37067.7026304078;37082.88751337464;38044;38094.61905380911;37044.814775925945;37886;37954.620453795105;38144.80927595344;38213.04467388338;33066;33458.16354591155;34013.82993085019;34096.14759631029;34178;24853.130140445;25168.622470662587;25395.87302063478;25463.618045729698;25577 11:07:32 INFO - PROCESS | 2592 | |2;jquery.html;356.6380124173963;360.2632616299667;362.5250921293106;364.4260290043181;371.92189640175565;14595.343209555569;15086.77369839452;15967.201639918016;19670;20929.581408371843;17626.823731762677;20409.285675001378;20586;20974.89512552439;21881.562368752657;5751.166080918275;6690.397864192221;6693.431058360045;6695.296993815652;6710.16122984627;4610.884727881813;6694.631795251284;7200.38796702281;7675.577843218621;7703.38372930167;7389.963050184741;7533.547987120763;7583.393328533704;7646.961765191167;7662.578558179298;7369.520981136209;7533.924660753377;7608.391328693719;7625.161232264447;7646.61766911655;7036.366726994544;7110.893336599956;7208.49540532163;7228.421726261887;7230.385417239489;25929.61105583418;26296.342591435176;26592.86703566489;27441.86279068612;27748.02881899144;1734.9219285132199;2076.6158260721663;2434.3914021494625;2850.7074329149864;2971.7176868197485;15181.544553663407;15444.613884652861;15480.922595387063;15608.297626606716;16425.58936026597;1828.1316374722035;1831.377331707226;1839.7148441991512;1870.812918708132;1905.2569497895693;77610.44779104386;98191;99576;116654;125880;10797.946010269898;11029.786723460413;11033.779324413626;11039.83440248397;11117.722056948642;12264.693382665326;12562.685932851751;12621.495140194473;13393.861521770565;13442.395092220873;6475.32009139043;6594.901076483857;8035.236652518001;8521.957390213009;8625.439346442461;8603.31173506118;8635.78410539729;8659.740207793777;8688;8790.42862213954;4457.108578284357;4533.320001999727;4535.478419981679;4584.083183363341;4585.10590434862;1837.7243413488084;1890.5557194059386;1899.0599653171769;1911.7419148414785;1946.8734532255357;849.1211595998236;889.2796834563894;904.4663648447447;965.7247684409909;993.8471373207045;19494.927778972007;20320.491987700425;20740.896295518425;20860.69069486056;20878;845.9605384290064;892.1658249536704;932.3939439364332;936.1434287626745;960.7550074730899;8981.506017168987;10474.947625261824;10757.946210269056;10760.300580462244;10815.297005694605;256180;263536.364636355;284336;372544;585301.2204816932;118717;121037;121272.36182914527;121509;123685;1052.9262951593314;1055.625253035177;1118.1278602689915;1134.3817619397448;1136.2614300704608;18832.52918676989;18833.529161771065;18981.620367592295;18988.715169272196;19048.523786904883;41111.943653528666;50359.74820125876;52042.21936670877;52759.472405275454;52855.47144528505;55760.72119639376;68432.63134737377;71879.28120718726;73566.63216683883;74153;7713.845723085395;7894.250046245597;7922.207779222032;7957.920420795718;7988.560629165219;11085.889141108808;11181.888181118085;12297.44661490253;12531.373431328579;12557.372131393211;7853.882191767014;8183.6906095024515;10873.347599144077;10983.39591322485;11258.973384790816;9964.252681049094;10650.360978341325;10653.840192397276;11026.283291586022;11081.335119892832;10430.53062612169;11315.264507806965;11400.372979486208;11535;11562.710932226762;7547.245175624603;7842.29419352261;8001.999750031246;8004.959975200087;8041.396895232998;11126.221164518405;11165.609203677832;11356.0915126788;11389.487473063566;11395.430228488709 11:07:32 INFO - PROCESS | 2592 | |3;mootools.html;1352.2697743218662;1484.2207840883536;1519.574519134642;1737.5482374582605;1932.2753967262286;7887.5267483951;8531.27484163846;8719.258862996638;8724.258438032759;8737.95631021844;8392.412531122824;8655.826883462343;8669.21977022068;8670.739877803677;8676;2149.9355019349446;2415.10641062807;2437.6343548467785;2468.4939587384542;2471.9629205561932;2456.45957889265;2462.704475462947;2495.126705653016;2498.1381423408893;2502.5495410826043;2428.6842710447618;2466.4573793765344;2467.3214865911837;2469.234537293436;2475.170817776047;2406.097713357491;2450.0077468625145;2461;2463.8275320727557;2465.4329504214043;2455.054803900511;2472.4684192898612;2473.0355161487037;2485.875706214682;2494.1893884487613;8564.657413703506;8664.133586641348;8668.046514883357;8671.219590236846;8681.2186903179;5347.224652425377;5544.695041772701;5546.195801608785;5547.916781248285;5550.555955523589;3060.1125673554643;3616.2405894762132;3649.251903359805;3725.012871589031;3751.606081361445;1060.5704689600648;1061.124572227915;1066.1044722433116;1101.7741363020561;1110.4780753046055;11662;11781.528738850435;11862.762744745056;11875.762484750343;11882.702932426671;4919.1391506486225;4940.802367905316;5021.020900924358;5022.196448568212;5029.17018691919;10087.293889427816;10126.493675316353;10137.645182418728;10152.187824973984;10176.643817466353;4954.504549545017;5541.224228607998;5544.279243698294;5545.72271386429;5554.2779438672715;4474.776261186993;4528.569785870337;4533.116042371706;4536.841210557681;4756.762161891892;3921.274564205631;3947.7236593438183;3983.6016398359934;3990.102226998902;4016.859409920639;1282.7306265684124;1318.1102755640097;1319.070055610792;1328.7076843094503;1333.0468714868916;1299.5516546791341;1323.0606269548728;1323.4573824731813;1331.3210262765865;1354.5056054540023;8042.879356809653;8076.798080047928;8147.266745992889;8151.347892168612;8154.633041513146;505.91652377357326;506.0385267990847;510.12258914666717;515.4690668611337;526.5234962359071;6124.938750612437;6149.938500615026;6211.130441738161;6214.1921550198185;6222.906656400158;10267;10672.78654426907;10673.039426451656;10691.465426728633;10768.78462430747;10282.691519254435;10510.896355882522;10579.84130238047;10639.89360106389;10668.466576671135;8252.917470825216;8279.420440569224;8284.668613255522;8358.791030224293;8360.623771930277;6739.5619284746335;7627.084749830056;7723.497972631761;7823.100343460575;7866.0560732710155;9414.340996130206;9507.524623768646;9561.713148605553;9651.034896510293;9711.708648740549;9311.068893110634;9670.75823104428;9684.95157524208;9980.351277166961;10026.498675066363;6366.193523889434;6557.442617377576;7356.48504604694;7474.7757567273065;7492.100947886289;8059.274665280153;8129.552874591955;8224.054233762954;8227.71203007892;8238.299744521542;7212.783616491513;7324.230955749569;7327.413806895543;7463.17905030457;7469.551826890404;7140.9285907140265;7213.314735100157;7260.382867456326;7288.635568221674;7353.448491363276;7352;7614.314711675976;7619.276168763959;7620.733274335372;7632.732854350294;6848.7260509579055;6937.132858392701;6939.236683964861;6942.8611427772175;6963.895541566982;6904.171499420102;7053.753118640823;7056.400205982549;7056.576605403692;7061.576305421691 11:07:32 INFO - PROCESS | 2592 | |4;prototype.html;253.37669333439737;320.7674436033875;321.1954055091994;324.0876931438003;327.72143677873794;5328.721106934337;6437.163168788057;6466.094746735455;6563.245226798919;6585.176852893388;6476.546641735081;6522.119513865627;6536.901946470807;6537.287025884264;6553.9841324594645;3906.277338692337;4706.411698537683;4726.385569875912;4861.319415281863;4868.707877527342;4677.06458708258;4782.713037217761;4839.056384005103;4843.5156484351455;4845.273209018657;4732.550407711262;4747.098051370246;4768.403949506312;4785.521447855222;4785.760711964388;4564.56216291867;4604.286335617984;4739.075880203327;4746.931940313437;4772.785224664898;4065.9796701016307;4083.203775263825;4084.550699423061;4095.5290141633795;4096.938545921814;6228.096925945758;6291.307956124822;6300.842478938017;6301.08634248036;6319.210098737658;5665.603407761459;5676.347220069662;5678.886422271573;5698.40166782486;5700.37295897451;6613.503987200979;6868.072810170613;6874.793756187322;6907.896381554281;6914.651642929631;4490.797914093873;4498.685092043558;4505.301678239878;4520.095980803852;4523.819047238107;7271.963640181765;7347.706091756377;7359.264073592652;7360.411167106618;7364.852702945965;4130.554305992879;4159.7920103994675;4387.122575484916;4549.294859296814;4554.225781617133;3794.430835374716;4580.931286030712;4604.102200070954;4656.185167595657;4661.813527458931;5519.586031047687;5529.557635389159;5543.667379957215;5545.528630066489;5564.415736347625;6739.460843132538;7003.92996070043;7012.158540975116;7016.789496315118;7025.789226323219;1596.9041857488587;1601.375463569209;1617.7007253658112;1618.9595260118592;1625.9430919917982;894.1952242981239;1023.3706270643501;1034.1158309645296;1046.9685909422728;1047.177965297238;6347.270063942613;6503.28463868974;6508.349165083454;6515.902261466082;6523.543351965317;5696.715164241771;7297.197308296083;7314.670839812221;7329.816754581178;7335.853282934311;6379.5215358847345;6574.769883054166;6591.307912669196;6593.86812263752;6598.505112116611;3821.636944490269;3852.152526444178;3880.631340022693;3885.786281754474;3893.2213557288655;6409.711562979677;7624.656890439833;7632.274933881273;7638.236176382317;7641.1212710539;7251.202367739545;7306.561606303639;7519.661615227328;7520.172780994087;7527.3225409712295;7554;7611.847763044708;7613.352865006536;7614.933909252709;7623.923760762433;7320.231375705687;7322.231165727522;7330.853382932418;7337.0828646419195;7338.743143989935;5849.707514624167;6003.45968862787;6816.795496135124;7053.4004609608755;7206.6396680164735;6506.967465162644;7269.382102521134;7521.924780752122;7583.317501424898;7592.696292148252;4585.10590434862;4595.954040459553;4604.424446944132;4610.147122782296;4611.723296602215;7006.932954778455;7203.099612548432;7209.990601315925;7322.560646361236;7325.304096110861;7020.964895175492;7051.6474176292;7064.187618423947;7073.328033836778;7099.787006389816;7041.5564809212965;7061.576305421486;7064.399526040139;7069.9646501767165;7071.858562828612;5754.6547207167705;6568.6058836469965;6569.9343006571235;6860.382565569123;6891.689873955584;6655.600663960178;6809.285025072296;6842.315768423317;7017.157941046903;7060.7881763547175;6084.543659225665;6266.717997690023;6846.178458585002;6851.588904665736;6870.381665650116 11:07:32 INFO - PROCESS | 2592 | |5;yui.html;654.5777973207281;708.8759467093257;718.0952000479394;743.851229754049;773.0684525147202;14354.569362919103;14523.709525809478;14552.981291309612;14570.344334504945;14596.781048284285;10309.58761649535;12943.935280323609;12949.935250323759;12968.286744229064;13003.219806811598;714.731975509184;728.7412968396222;869.617368357922;879.3712495565669;887.7248053103526;869.5826003518315;889.3818795936827;890.2699786175307;892.857142857143;893.1604291965564;933.9392939458947;935.2331088507426;936.2089034765612;937.9437233765962;938.755923459902;747.7420289999968;916.7753900294471;931.3154831199063;934.3973137326454;935.2331088507426;692.9237783843773;694.007569176078;694.6110178300117;695.2942763095463;696.5298423564125;13825.51610693631;13899.957503187201;13906.721865562733;13929.721405571932;13966.231857247847;9957.800843983152;11908.225965312227;11967.760644787142;11999.220050696764;12145.453454594564;7924.960375198087;9497;9582.616695332179;9607.855882161773;10186.694399168036;2708.607251948476;3143.905682829519;3197.9411882057316;3243.5783348164587;3245.7403407727325;78995;79472.20527794764;80767.59616201882;81705;82130.3573928518;8974.237189838806;9001.54992250398;9018.909810901938;9130.360874738837;9218.631254749735;19349.12928918202;19349.903250483938;19358.322458713876;19367.903160484388;19393.709094363596;6825.55633883796;6836.589804611739;6858.1084459021;6971.477139214478;6980.546264492792;3743.887683369503;3789.2989796887664;3825.196708691206;3850.422436634471;3894.1432884765304;3335.5997280326515;3387.4241378965635;3399.6770306820813;3403.540522029544;3406.795592264472;612.3662009819905;625.565232163651;628.9622622642564;632.8670979094442;645.9903101453482;531.4871149340827;584.155894732108;614.1789593854244;620.919280493542;626.7837596029362;7649.388048956182;7951.84096318082;8102.837943241102;8308.792280192923;8330.458520196167;506.344284152024;523.5262087810538;525.6777168296406;600.3486217454024;629.9653519056404;3207.230264736493;3483.7387195960405;3733.1973625670066;3737.289914916157;3823.751456155341;92967;93297.53351233201;93456;93623;95442.52278738562;81792;82402;82509.17490825136;83294.3341133174;83483;68211;68463.97304040444;68765.93702188942;68986;69620.3037969624;7451.5901625411125;7487.513311634726;7706.653200606098;7712.228777122243;7788.026496687914;36241.818790905876;50053.49946500634;51850;52201.694957626365;53218.93562128813;66424.66787666031;67108;67224;71333.64333178301;73209.53580928245;9156.130167634064;9194.9540252301;9230.215431688383;9231.261499079923;9254.25965922738;9890.258230632875;9914.157296629868;10590.258681892194;11752.941235293769;12497.562585309834;10939.617113400993;10947.616833410792;11069.391183484986;11072.889271107186;11226.989570938655;10754.784904301714;10760.569577216824;10834.729131771453;10853.837192441963;10992;10375.896241037795;10702.143828493547;10842.512086956263;10878;10926.836097458703;9087.636494540144;9201.631934722536;9303.395279306824;9731.756706082404;9803.705888823346;8348.87476687838;9490.905090949002;9653.276004299565;9691.97138314791;9897.50512474359 11:07:32 INFO - PROCESS | 2592 | __end_tp_report 11:07:32 INFO - PROCESS | 2592 | __start_cc_report 11:07:32 INFO - PROCESS | 2592 | _x_x_mozilla_cycle_collect,1132 11:07:32 INFO - PROCESS | 2592 | __end_cc_report 11:07:32 INFO - PROCESS | 2592 | __startTimestamp1455908852461__endTimestamp 11:07:32 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | ------- Summary: start ------- 11:07:32 INFO - PROCESS | 2592 | Number of tests: 6 11:07:32 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | [#0] dojo.html Cycles:165 Average:5653.19 Median:5885.21 stddev:648.31 (11.0%) stddev-sans-first:619.42 11:07:32 INFO - PROCESS | 2592 | Values: 3132.9 3396.0 3430.5 3432.2 3475.3 5573.2 5591.5 5629.4 5638.4 5654.2 5609.6 5639.3 5668.0 5757.9 5763.1 5056.8 5107.7 5114.2 5146.9 5225.2 5196.4 5257.6 5260.9 5269.5 5297.9 5093.3 5103.6 5148.7 5184.8 5234.9 4280.4 4933.4 5038.1 5066.8 5081.7 4970.3 5000.8 5010.7 5048.7 5085.2 5437.6 5546.0 5570.4 5574.3 5665.7 6212.0 6218.9 6229.3 6235.1 6243.0 5171.8 6111.0 6200.0 6281.2 6290.2 5767.9 5814.5 5823.9 5870.1 5873.2 6279.7 6281.0 6302.6 6313.4 6313.9 5842.3 6063.0 6064.8 6066.8 6080.6 6138.4 6199.7 6202.2 6218.9 6231.4 6070.1 6077.3 6148.3 6176.0 6181.9 6070.0 6124.8 6128.6 6130.9 6188.4 4848.8 4852.9 4864.5 4886.5 4888.4 4364.8 4380.3 4387.2 4388.1 4448.8 5566.2 5591.7 5663.5 5690.9 5713.4 6029.3 6034.2 6072.9 6080.9 6108.9 5477.7 5484.4 5491.2 5493.9 5512.4 5231.6 5324.8 5360.4 5382.9 5408.4 5219.2 6253.7 6254.0 6266.3 6277.7 5184.8 6095.9 6299.3 6303.5 6313.8 5237.8 6221.7 6234.0 6237.2 6259.6 6095.8 6107.6 6109.2 6133.0 6163.7 6132.2 6149.3 6220.9 6268.4 6270.4 4797.0 5890.7 6094.6 6117.7 6128.5 5890.4 6094.4 6100.6 6118.4 6136.6 5885.2 5929.6 5935.4 5941.8 6015.0 6002.5 6055.1 6058.7 6064.8 6075.1 5810.7 5889.3 5907.6 5926.8 5932.8 11:07:32 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | [#1] ext.html Cycles:180 Average:64305.91 Median:39757.60 stddev:136864.11 (344.2%) stddev-sans-first:137164.10 11:07:32 INFO - PROCESS | 2592 | Values: 458.3 486.6 490.4 561.8 577.9 28397.9 37772.6 38203.6 38366.6 38436.6 40922.8 41300.0 41310.2 41399.4 41435.4 9539.3 9792.8 9797.3 9805.9 9807.1 9568.6 9734.4 9735.8 9736.0 9737.4 9688.8 9865.6 9870.9 9893.8 9906.0 9707.6 9820.3 9823.9 9824.0 9828.1 7914.2 9097.8 9446.1 9556.8 9724.6 39291.0 39675.4 39691.6 39753.6 39761.6 3347.1 3374.7 3528.5 3626.3 3772.5 28129.6 28955.0 29064.7 29409.7 29943.0 2730.9 2737.4 2759.5 2893.7 2935.9 473719.0 475544.0 475969.0 475990.0 476446.0 44143.8 44916.3 45182.3 60300.7 60620.0 36794.0 43259.3 43796.0 44168.5 44176.3 15221.7 15380.5 15404.5 15453.5 15459.7 12359.9 12450.6 12456.9 12462.2 12464.9 14118.8 14244.0 14297.6 14313.9 14347.1 6303.8 6338.2 6341.6 6386.6 6399.5 858.6 935.9 991.4 1041.3 1055.4 29579.6 29856.1 30121.0 30195.5 30652.9 875.7 1051.4 1052.2 1074.8 1177.7 13937.6 15892.4 15902.9 16179.1 16570.3 602353.0 604896.0 610109.0 610576.0 611676.0 58603.0 58924.0 59153.7 59248.7 59311.7 1245.8 1312.0 1340.4 1439.6 1582.4 28287.2 28472.1 28962.4 29009.9 29081.0 40822.0 53818.7 54974.9 55034.7 55047.2 432546.8 432994.4 436079.0 437536.0 466393.0 40104.8 40448.6 40559.4 40604.6 40927.8 44948.6 45197.9 45277.0 46299.5 46488.8 36340.6 37263.0 38151.0 38470.2 38471.0 36921.4 37067.7 37082.9 38044.0 38094.6 37044.8 37886.0 37954.6 38144.8 38213.0 33066.0 33458.2 34013.8 34096.1 34178.0 24853.1 25168.6 25395.9 25463.6 25577.0 11:07:32 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | [#2] jquery.html Cycles:180 Average:27389.75 Median:27017.36 stddev:64611.35 (239.1%) stddev-sans-first:64760.72 11:07:32 INFO - PROCESS | 2592 | Values: 356.6 360.3 362.5 364.4 371.9 14595.3 15086.8 15967.2 19670.0 20929.6 17626.8 20409.3 20586.0 20974.9 21881.6 5751.2 6690.4 6693.4 6695.3 6710.2 4610.9 6694.6 7200.4 7675.6 7703.4 7390.0 7533.5 7583.4 7647.0 7662.6 7369.5 7533.9 7608.4 7625.2 7646.6 7036.4 7110.9 7208.5 7228.4 7230.4 25929.6 26296.3 26592.9 27441.9 27748.0 1734.9 2076.6 2434.4 2850.7 2971.7 15181.5 15444.6 15480.9 15608.3 16425.6 1828.1 1831.4 1839.7 1870.8 1905.3 77610.4 98191.0 99576.0 116654.0 125880.0 10797.9 11029.8 11033.8 11039.8 11117.7 12264.7 12562.7 12621.5 13393.9 13442.4 6475.3 6594.9 8035.2 8522.0 8625.4 8603.3 8635.8 8659.7 8688.0 8790.4 4457.1 4533.3 4535.5 4584.1 4585.1 1837.7 1890.6 1899.1 1911.7 1946.9 849.1 889.3 904.5 965.7 993.8 19494.9 20320.5 20740.9 20860.7 20878.0 846.0 892.2 932.4 936.1 960.8 8981.5 10474.9 10757.9 10760.3 10815.3 256180.0 263536.4 284336.0 372544.0 585301.2 118717.0 121037.0 121272.4 121509.0 123685.0 1052.9 1055.6 1118.1 1134.4 1136.3 18832.5 18833.5 18981.6 18988.7 19048.5 41111.9 50359.7 52042.2 52759.5 52855.5 55760.7 68432.6 71879.3 73566.6 74153.0 7713.8 7894.3 7922.2 7957.9 7988.6 11085.9 11181.9 12297.4 12531.4 12557.4 7853.9 8183.7 10873.3 10983.4 11259.0 9964.3 10650.4 10653.8 11026.3 11081.3 10430.5 11315.3 11400.4 11535.0 11562.7 7547.2 7842.3 8002.0 8005.0 8041.4 11126.2 11165.6 11356.1 11389.5 11395.4 11:07:32 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | [#3] mootools.html Cycles:180 Average:5995.14 Median:521.00 stddev:3173.38 (609.1%) stddev-sans-first:3163.09 11:07:32 INFO - PROCESS | 2592 | Values: 1352.3 1484.2 1519.6 1737.5 1932.3 7887.5 8531.3 8719.3 8724.3 8738.0 8392.4 8655.8 8669.2 8670.7 8676.0 2149.9 2415.1 2437.6 2468.5 2472.0 2456.5 2462.7 2495.1 2498.1 2502.5 2428.7 2466.5 2467.3 2469.2 2475.2 2406.1 2450.0 2461.0 2463.8 2465.4 2455.1 2472.5 2473.0 2485.9 2494.2 8564.7 8664.1 8668.0 8671.2 8681.2 5347.2 5544.7 5546.2 5547.9 5550.6 3060.1 3616.2 3649.3 3725.0 3751.6 1060.6 1061.1 1066.1 1101.8 1110.5 11662.0 11781.5 11862.8 11875.8 11882.7 4919.1 4940.8 5021.0 5022.2 5029.2 10087.3 10126.5 10137.6 10152.2 10176.6 4954.5 5541.2 5544.3 5545.7 5554.3 4474.8 4528.6 4533.1 4536.8 4756.8 3921.3 3947.7 3983.6 3990.1 4016.9 1282.7 1318.1 1319.1 1328.7 1333.0 1299.6 1323.1 1323.5 1331.3 1354.5 8042.9 8076.8 8147.3 8151.3 8154.6 505.9 506.0 510.1 515.5 526.5 6124.9 6149.9 6211.1 6214.2 6222.9 10267.0 10672.8 10673.0 10691.5 10768.8 10282.7 10510.9 10579.8 10639.9 10668.5 8252.9 8279.4 8284.7 8358.8 8360.6 6739.6 7627.1 7723.5 7823.1 7866.1 9414.3 9507.5 9561.7 9651.0 9711.7 9311.1 9670.8 9685.0 9980.4 10026.5 6366.2 6557.4 7356.5 7474.8 7492.1 8059.3 8129.6 8224.1 8227.7 8238.3 7212.8 7324.2 7327.4 7463.2 7469.6 7140.9 7213.3 7260.4 7288.6 7353.4 7352.0 7614.3 7619.3 7620.7 7632.7 6848.7 6937.1 6939.2 6942.9 6963.9 6904.2 7053.8 7056.4 7056.6 7061.6 11:07:32 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | [#4] prototype.html Cycles:180 Average:5669.35 Median:6471.32 stddev:1829.77 (28.3%) stddev-sans-first:1789.17 11:07:32 INFO - PROCESS | 2592 | Values: 253.4 320.8 321.2 324.1 327.7 5328.7 6437.2 6466.1 6563.2 6585.2 6476.5 6522.1 6536.9 6537.3 6554.0 3906.3 4706.4 4726.4 4861.3 4868.7 4677.1 4782.7 4839.1 4843.5 4845.3 4732.6 4747.1 4768.4 4785.5 4785.8 4564.6 4604.3 4739.1 4746.9 4772.8 4066.0 4083.2 4084.6 4095.5 4096.9 6228.1 6291.3 6300.8 6301.1 6319.2 5665.6 5676.3 5678.9 5698.4 5700.4 6613.5 6868.1 6874.8 6907.9 6914.7 4490.8 4498.7 4505.3 4520.1 4523.8 7272.0 7347.7 7359.3 7360.4 7364.9 4130.6 4159.8 4387.1 4549.3 4554.2 3794.4 4580.9 4604.1 4656.2 4661.8 5519.6 5529.6 5543.7 5545.5 5564.4 6739.5 7003.9 7012.2 7016.8 7025.8 1596.9 1601.4 1617.7 1619.0 1625.9 894.2 1023.4 1034.1 1047.0 1047.2 6347.3 6503.3 6508.3 6515.9 6523.5 5696.7 7297.2 7314.7 7329.8 7335.9 6379.5 6574.8 6591.3 6593.9 6598.5 3821.6 3852.2 3880.6 3885.8 3893.2 6409.7 7624.7 7632.3 7638.2 7641.1 7251.2 7306.6 7519.7 7520.2 7527.3 7554.0 7611.8 7613.4 7614.9 7623.9 7320.2 7322.2 7330.9 7337.1 7338.7 5849.7 6003.5 6816.8 7053.4 7206.6 6507.0 7269.4 7521.9 7583.3 7592.7 4585.1 4596.0 4604.4 4610.1 4611.7 7006.9 7203.1 7210.0 7322.6 7325.3 7021.0 7051.6 7064.2 7073.3 7099.8 7041.6 7061.6 7064.4 7070.0 7071.9 5754.7 6568.6 6569.9 6860.4 6891.7 6655.6 6809.3 6842.3 7017.2 7060.8 6084.5 6266.7 6846.2 6851.6 6870.4 11:07:32 INFO - PROCESS | 2592 | 11:07:32 INFO - PROCESS | 2592 | [#5] yui.html Cycles:180 Average:18020.88 Median:37661.04 stddev:26196.24 (69.6%) stddev-sans-first:26237.27 11:07:32 INFO - PROCESS | 2592 | Values: 654.6 708.9 718.1 743.9 773.1 14354.6 14523.7 14553.0 14570.3 14596.8 10309.6 12943.9 12949.9 12968.3 13003.2 714.7 728.7 869.6 879.4 887.7 869.6 889.4 890.3 892.9 893.2 933.9 935.2 936.2 937.9 938.8 747.7 916.8 931.3 934.4 935.2 692.9 694.0 694.6 695.3 696.5 13825.5 13900.0 13906.7 13929.7 13966.2 9957.8 11908.2 11967.8 11999.2 12145.5 7925.0 9497.0 9582.6 9607.9 10186.7 2708.6 3143.9 3197.9 3243.6 3245.7 78995.0 79472.2 80767.6 81705.0 82130.4 8974.2 9001.5 9018.9 9130.4 9218.6 19349.1 19349.9 19358.3 19367.9 19393.7 6825.6 6836.6 6858.1 6971.5 6980.5 3743.9 3789.3 3825.2 3850.4 3894.1 3335.6 3387.4 3399.7 3403.5 3406.8 612.4 625.6 629.0 632.9 646.0 531.5 584.2 614.2 620.9 626.8 7649.4 7951.8 8102.8 8308.8 8330.5 506.3 523.5 525.7 600.3 630.0 3207.2 3483.7 3733.2 3737.3 3823.8 92967.0 93297.5 93456.0 93623.0 95442.5 81792.0 82402.0 82509.2 83294.3 83483.0 68211.0 68464.0 68765.9 68986.0 69620.3 7451.6 7487.5 7706.7 7712.2 7788.0 36241.8 50053.5 51850.0 52201.7 53218.9 66424.7 67108.0 67224.0 71333.6 73209.5 9156.1 9195.0 9230.2 9231.3 9254.3 9890.3 9914.2 10590.3 11752.9 12497.6 10939.6 10947.6 11069.4 11072.9 11227.0 10754.8 10760.6 10834.7 10853.8 10992.0 10375.9 10702.1 10842.5 10878.0 10926.8 9087.6 9201.6 9303.4 9731.8 9803.7 8348.9 9490.9 9653.3 9692.0 9897.5 11:07:32 INFO - PROCESS | 2592 | -------- Summary: end -------- 11:07:32 INFO - PROCESS | 2592 | 11:07:33 INFO - TEST-INFO | 2592: exit 0 11:07:33 INFO - TEST-OK | dromaeo_css | took 1113364ms 11:07:33 INFO - TEST-START | kraken 11:07:33 INFO - operating with platform_type : mac_ 11:07:33 INFO - Initialising browser for kraken test... 11:07:33 INFO - TEST-INFO | started process 2595 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/tmppjj3Iz/profile http://localhost:50292/getInfo.html) 11:07:35 INFO - PROCESS | 2595 | __metrics Screen width/height:1600/1200 11:07:35 INFO - PROCESS | 2595 | colorDepth:24 11:07:35 INFO - PROCESS | 2595 | Browser inner width/height: 1024/689 11:07:35 INFO - PROCESS | 2595 | __metrics 11:07:35 INFO - PROCESS | 2595 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 668: Error: Phase "quit-application-granted is finished, it is too late to register completion condition "SessionStore: flushing all windows" 11:07:35 INFO - PROCESS | 2595 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:07:36 INFO - TEST-INFO | 2595: exit 0 11:07:36 INFO - Browser initialized. 11:07:36 INFO - Running cycle 1/1 for kraken test... 11:07:36 INFO - TEST-INFO | started process 2597 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/tmppjj3Iz/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:07:48 INFO - PROCESS | 2597 | RSS: Main: 244551680 11:07:48 INFO - PROCESS | 2597 | 11:07:50 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50292/tests/kraken/driver.html?testName=audio-beat-detection) 11:07:51 INFO - PROCESS | 2597 | RSS: Main: 291110912 11:07:51 INFO - PROCESS | 2597 | 11:07:53 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50292/tests/kraken/driver.html?testName=audio-dft) 11:07:54 INFO - PROCESS | 2597 | RSS: Main: 301121536 11:07:54 INFO - PROCESS | 2597 | 11:07:57 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50292/tests/kraken/driver.html?testName=audio-fft) 11:07:58 INFO - PROCESS | 2597 | RSS: Main: 286261248 11:07:58 INFO - PROCESS | 2597 | 11:08:00 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50292/tests/kraken/driver.html?testName=audio-oscillator) 11:08:00 INFO - PROCESS | 2597 | RSS: Main: 288858112 11:08:00 INFO - PROCESS | 2597 | 11:08:02 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50292/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:08:03 INFO - PROCESS | 2597 | RSS: Main: 291016704 11:08:03 INFO - PROCESS | 2597 | 11:08:06 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50292/tests/kraken/driver.html?testName=imaging-darkroom) 11:08:06 INFO - PROCESS | 2597 | RSS: Main: 291917824 11:08:06 INFO - PROCESS | 2597 | 11:08:09 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50292/tests/kraken/driver.html?testName=imaging-desaturate) 11:08:10 INFO - PROCESS | 2597 | RSS: Main: 291409920 11:08:10 INFO - PROCESS | 2597 | 11:08:12 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50292/tests/kraken/driver.html?testName=json-parse-financial) 11:08:13 INFO - PROCESS | 2597 | RSS: Main: 291553280 11:08:13 INFO - PROCESS | 2597 | 11:08:14 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50292/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:08:15 INFO - PROCESS | 2597 | RSS: Main: 326193152 11:08:15 INFO - PROCESS | 2597 | 11:08:17 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50292/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:08:18 INFO - PROCESS | 2597 | RSS: Main: 324284416 11:08:18 INFO - PROCESS | 2597 | 11:08:20 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50292/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:08:20 INFO - PROCESS | 2597 | RSS: Main: 333328384 11:08:20 INFO - PROCESS | 2597 | 11:08:23 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50292/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:08:24 INFO - PROCESS | 2597 | RSS: Main: 334409728 11:08:24 INFO - PROCESS | 2597 | 11:08:26 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50292/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:08:27 INFO - PROCESS | 2597 | RSS: Main: 334712832 11:08:27 INFO - PROCESS | 2597 | 11:08:28 INFO - PROCESS | 2597 | Cycle 1(1): loaded http://localhost:50292/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50292/tests/kraken/driver.html?testName=ai-astar) 11:08:29 INFO - PROCESS | 2597 | RSS: Main: 395452416 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | __start_tp_report 11:08:29 INFO - PROCESS | 2597 | _x_x_mozilla_page_load 11:08:29 INFO - PROCESS | 2597 | _x_x_mozilla_page_load_details 11:08:29 INFO - PROCESS | 2597 | |i|pagename|runs| 11:08:29 INFO - PROCESS | 2597 | |0;ai-astar;139;155;110;110;110;111;115;110;110;111 11:08:29 INFO - PROCESS | 2597 | |1;audio-beat-detection;155;122;144;158;118;144;140;117;161;117 11:08:29 INFO - PROCESS | 2597 | |2;audio-dft;183;184;184;187;185;187;185;187;179;184 11:08:29 INFO - PROCESS | 2597 | |3;audio-fft;74;79;86;79;58;57;61;80;78;67 11:08:29 INFO - PROCESS | 2597 | |4;audio-oscillator;89;97;124;78;79;83;115;79;77;117 11:08:29 INFO - PROCESS | 2597 | |5;imaging-gaussian-blur;85;91;85;91;85;90;85;91;85;91 11:08:29 INFO - PROCESS | 2597 | |6;imaging-darkroom;94;95;94;95;94;94;95;94;94;93 11:08:29 INFO - PROCESS | 2597 | |7;imaging-desaturate;86;85;87;87;83;87;86;87;85;85 11:08:29 INFO - PROCESS | 2597 | |8;json-parse-financial;56;55;54;54;54;54;55;64;53;53 11:08:29 INFO - PROCESS | 2597 | |9;json-stringify-tinderbox;65;63;71;85;91;59;58;58;90;93 11:08:29 INFO - PROCESS | 2597 | |10;stanford-crypto-aes;83;83;82;83;87;106;106;108;103;83 11:08:29 INFO - PROCESS | 2597 | |11;stanford-crypto-ccm;129;131;130;117;130;118;115;113;114;128 11:08:29 INFO - PROCESS | 2597 | |12;stanford-crypto-pbkdf2;123;127;139;139;139;127;140;138;151;174 11:08:29 INFO - PROCESS | 2597 | |13;stanford-crypto-sha256-iterative;65;68;67;65;68;63;82;94;96;96 11:08:29 INFO - PROCESS | 2597 | __end_tp_report 11:08:29 INFO - PROCESS | 2597 | __start_cc_report 11:08:29 INFO - PROCESS | 2597 | _x_x_mozilla_cycle_collect,1150 11:08:29 INFO - PROCESS | 2597 | __end_cc_report 11:08:29 INFO - PROCESS | 2597 | __startTimestamp1455908909229__endTimestamp 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | ------- Summary: start ------- 11:08:29 INFO - PROCESS | 2597 | Number of tests: 14 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#0] ai-astar Cycles:10 Average:118.10 Median:111.00 stddev:15.77 (14.2%) stddev-sans-first:14.80 11:08:29 INFO - PROCESS | 2597 | Values: 139.0 155.0 110.0 110.0 110.0 111.0 115.0 110.0 110.0 111.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#1] audio-beat-detection Cycles:10 Average:137.60 Median:144.00 stddev:17.73 (12.3%) stddev-sans-first:17.66 11:08:29 INFO - PROCESS | 2597 | Values: 155.0 122.0 144.0 158.0 118.0 144.0 140.0 117.0 161.0 117.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#2] audio-dft Cycles:10 Average:184.50 Median:185.00 stddev:2.42 (1.3%) stddev-sans-first:2.50 11:08:29 INFO - PROCESS | 2597 | Values: 183.0 184.0 184.0 187.0 185.0 187.0 185.0 187.0 179.0 184.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#3] audio-fft Cycles:10 Average:71.90 Median:78.50 stddev:10.35 (13.2%) stddev-sans-first:10.95 11:08:29 INFO - PROCESS | 2597 | Values: 74.0 79.0 86.0 79.0 58.0 57.0 61.0 80.0 78.0 67.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#4] audio-oscillator Cycles:10 Average:93.80 Median:79.00 stddev:18.32 (23.2%) stddev-sans-first:19.35 11:08:29 INFO - PROCESS | 2597 | Values: 89.0 97.0 124.0 78.0 79.0 83.0 115.0 79.0 77.0 117.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#5] imaging-gaussian-blur Cycles:10 Average:87.90 Median:90.50 stddev:3.07 (3.4%) stddev-sans-first:3.07 11:08:29 INFO - PROCESS | 2597 | Values: 85.0 91.0 85.0 91.0 85.0 90.0 85.0 91.0 85.0 91.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#6] imaging-darkroom Cycles:10 Average:94.20 Median:94.00 stddev:0.63 (0.7%) stddev-sans-first:0.67 11:08:29 INFO - PROCESS | 2597 | Values: 94.0 95.0 94.0 95.0 94.0 94.0 95.0 94.0 94.0 93.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#7] imaging-desaturate Cycles:10 Average:85.80 Median:86.50 stddev:1.32 (1.5%) stddev-sans-first:1.39 11:08:29 INFO - PROCESS | 2597 | Values: 86.0 85.0 87.0 87.0 83.0 87.0 86.0 87.0 85.0 85.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#8] json-parse-financial Cycles:10 Average:55.20 Median:54.50 stddev:3.22 (5.9%) stddev-sans-first:3.41 11:08:29 INFO - PROCESS | 2597 | Values: 56.0 55.0 54.0 54.0 54.0 54.0 55.0 64.0 53.0 53.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#9] json-stringify-tinderbox Cycles:10 Average:73.30 Median:78.00 stddev:14.80 (19.0%) stddev-sans-first:15.38 11:08:29 INFO - PROCESS | 2597 | Values: 65.0 63.0 71.0 85.0 91.0 59.0 58.0 58.0 90.0 93.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#10] stanford-crypto-aes Cycles:10 Average:92.40 Median:83.00 stddev:11.63 (14.0%) stddev-sans-first:11.82 11:08:29 INFO - PROCESS | 2597 | Values: 83.0 83.0 82.0 83.0 87.0 106.0 106.0 108.0 103.0 83.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#11] stanford-crypto-ccm Cycles:10 Average:122.50 Median:128.50 stddev:7.65 (6.0%) stddev-sans-first:7.74 11:08:29 INFO - PROCESS | 2597 | Values: 129.0 131.0 130.0 117.0 130.0 118.0 115.0 113.0 114.0 128.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:139.70 Median:139.00 stddev:14.57 (10.5%) stddev-sans-first:14.14 11:08:29 INFO - PROCESS | 2597 | Values: 123.0 127.0 139.0 139.0 139.0 127.0 140.0 138.0 151.0 174.0 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - PROCESS | 2597 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:76.40 Median:75.00 stddev:14.06 (18.7%) stddev-sans-first:14.29 11:08:29 INFO - PROCESS | 2597 | Values: 65.0 68.0 67.0 65.0 68.0 63.0 82.0 94.0 96.0 96.0 11:08:29 INFO - PROCESS | 2597 | -------- Summary: end -------- 11:08:29 INFO - PROCESS | 2597 | 11:08:29 INFO - TEST-INFO | 2597: exit 0 11:08:29 INFO - TEST-OK | kraken | took 56928ms 11:08:29 INFO - SUITE-END | took 1170s 11:08:30 INFO - Completed test suite (00:19:30) 11:08:30 INFO - Working with test: dromaeo_css 11:08:30 INFO - Generating results file: dromaeo_css 11:08:30 INFO - Working with test: kraken 11:08:30 INFO - Generating results file: kraken 11:08:30 INFO - javascript benchmark 11:08:30 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:08:30 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,59]] 11:08:30 INFO - process_Request line: dromaeo_css 7411.25 graph.html#tests=[[72,64,59]] 11:08:30 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:08:30 INFO - process_Request line: kraken 1433.30 graph.html#tests=[[232,64,59]] 11:08:30 INFO - RETURN: dromaeo_css: 7411.25 11:08:30 INFO - RETURN: kraken: 1433.30 11:08:30 INFO - javascript benchmark 11:08:30 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3132.937341253175, 3396.049106250249, 3430.519727238187, 3432.1591210153515, 3475.3223121491305, 5573.247611572437, 5591.524720398771, 5629.437056294374, 5638.40796716345, 5654.18014387914, 5609.607327487078, 5639.2668953036155, 5668.036433806253, 5757.856053598662, 5763.0779075347955, 5056.797728090872, 5107.693538387699, 5114.2072978688175, 5146.871328216787, 5225.2162175673575, 5196.350456192976, 5257.605679574028, 5260.894782104356, 5269.473052694738, 5297.920531192035, 5093.286939828427, 5103.642745007851, 5148.6910785353, 5184.792608295664, 5234.895302093975, 4280.357946308048, 4933.407991041062, 5038.106459455023, 5066.822661206877, 5081.745912704387, 4970.2793095001025, 5000.849974500771, 5010.749462526859, 5048.747562621854, 5085.237214417867, 5437.619366644337, 5545.972270138664, 5570.415106413809, 5574.275344205268, 5665.716714164317, 6212.0371342441995, 6218.937810621881, 6229.314775374705, 6235.127082208494, 6242.96878515609, 5171.844844654666, 6110.953680641517, 6200.0, 6281.152044473984, 6290.21372328459, 5767.942320576824, 5814.534837213013, 5823.941760582425, 5870.060790273578, 5873.236479257755, 6279.686015699197, 6280.968595157086, 6302.621842689453, 6313.43179113882, 6313.905291420632, 5842.328132264759, 6062.969685151546, 6064.848378790565, 6066.848328791815, 6080.604760690541, 6138.416850399205, 6199.659018753921, 6202.1937148171355, 6218.9378106218355, 6231.4391704745885, 6070.119832624245, 6077.331493535796, 6148.292946311142, 6175.96912015446, 6181.938180618226, 6069.969650151809, 6124.785632502841, 6128.6171709010705, 6130.918788798945, 6188.350223226586, 4848.806047758121, 4852.902941941142, 4864.513548645178, 4886.511348865156, 4888.364512613338, 4364.803583838735, 4380.342948557678, 4387.232234359039, 4388.1223755249075, 4448.777561121996, 5566.248556444828, 5591.692456914828, 5663.461971112738, 5690.9430905690415, 5713.428657134254, 6029.276486821609, 6034.24571928509, 6072.908906366408, 6080.939190608037, 6108.877822443526, 5477.698726569997, 5484.424135465799, 5491.2312276281355, 5493.917591236134, 5512.366077901012, 5231.607629427808, 5324.7870085196155, 5360.383555891122, 5382.91925621116, 5408.378036525771, 5219.243209734643, 6253.74985000604, 6254.0, 6266.279377871603, 6277.71750271248, 5184.766685499086, 6095.908561371494, 6299.275583307978, 6303.527235457267, 6313.842153946004, 5237.8428647140645, 6221.657808820377, 6234.0, 6237.157983672146, 6259.593126446766, 6095.75616975316, 6107.572469927062, 6109.236345456818, 6133.0, 6163.660998645118, 6132.171952247653, 6149.323574406722, 6220.906686399798, 6268.404501572343, 6270.372962703693, 4797.0, 5890.704045110069, 6094.634321940698, 6117.724702388314, 6128.540359473147, 5890.381509941394, 6094.390560944047, 6100.633961962297, 6118.449339559283, 6136.601120927304, 5885.205497257815, 5929.584929054925, 5935.40645935403, 5941.792037278848, 6015.0, 6002.519798416203, 6055.122007308827, 6058.697065146813, 6064.848378790565, 6075.149479073022, 5810.709464526842, 5889.263842019747, 5907.586468947133, 5926.7925622603, 5932.762689492544], "unit": "score", "name": "dojo.html", "value": 5613.177768910685}, {"lowerIsBetter": false, "replicates": [458.2896510408867, 486.5548023558444, 490.3723234260147, 561.8061619059499, 577.9046457334538, 28397.858010709944, 37772.62227377729, 38203.617963820354, 38366.61633383665, 38436.615633843685, 40922.79538602303, 41300.0, 41310.17379652405, 41399.379009314885, 41435.37846932291, 9539.284553658468, 9792.755181120458, 9797.26520510961, 9805.901940980606, 9807.117359437649, 9568.617255309779, 9734.367266127714, 9735.75660608487, 9736.026397360278, 9737.415755054719, 9688.806223875517, 9865.556049977733, 9870.851937220947, 9893.802123957517, 9906.0, 9707.61169553217, 9820.31257811957, 9823.852642210373, 9823.950880245624, 9828.066333698287, 7914.208579142098, 9097.81804363909, 9446.055394460567, 9556.761080972961, 9724.611015559369, 39291.0, 39675.40486892699, 39691.60308396908, 39753.60246397528, 39761.60238397608, 3347.146477648184, 3374.6625337466303, 3528.523649307362, 3626.2566173934542, 3772.4718539404507, 28129.57805632917, 28955.0, 29064.70935290641, 29409.705902941125, 29942.95199668001, 2730.863456827151, 2737.3840885800737, 2759.4894944435346, 2893.7250961158657, 2935.911922642324, 473719.0, 475544.0, 475969.0, 475990.0, 476446.0, 44143.779281104034, 44916.3262551062, 45182.32226516605, 60300.69849650723, 60620.0, 36794.0, 43259.26962921511, 43796.0, 44168.46652267811, 44176.3373549397, 15221.695566088616, 15380.461683841011, 15404.46084387041, 15453.5363939082, 15459.690806184039, 12359.876401236052, 12450.626481205578, 12456.875431245753, 12462.189957652723, 12464.875351246554, 14118.788218176736, 14244.0, 14297.571072867831, 14313.85686143146, 14347.139171649735, 6303.842403939938, 6338.239411270585, 6341.55609107358, 6386.584871983307, 6399.520035997226, 858.6007506509503, 935.8876934767871, 991.3605724307781, 1041.286718597763, 1055.3747229266996, 29579.556306655417, 29856.05935614178, 30121.0, 30195.547066794017, 30652.92714754973, 875.7363602865471, 1051.3691784929135, 1052.163529993657, 1074.7581794096266, 1177.735009622828, 13937.58187254384, 15892.364305427653, 15902.920485397499, 16179.05976759528, 16570.337186512403, 602353.0, 604896.0, 610109.0, 610576.0, 611676.0, 58603.0, 58924.0, 59153.704231478565, 59248.7037564818, 59311.70344148252, 1245.8068999305121, 1311.9934400327936, 1340.3566288181728, 1439.6113049476792, 1582.3907795498585, 28287.15138545847, 28472.145835624964, 28962.420751585272, 29009.854950725112, 29081.0, 40822.0, 53818.730906346784, 54974.90050199054, 55034.72482637561, 55047.174292386444, 432546.8372658116, 432994.3706192253, 436079.0, 437536.0, 466393.0, 40104.79947600243, 40448.59551404566, 40559.39160912648, 40604.59395406008, 40927.77216683504, 44948.55051449444, 45197.87005324893, 45277.0, 46299.53700462952, 46488.767556162005, 36340.636593633724, 37263.0, 38151.0, 38470.23059538849, 38471.0, 36921.44617830789, 37067.7026304078, 37082.88751337464, 38044.0, 38094.61905380911, 37044.814775925945, 37886.0, 37954.620453795105, 38144.80927595344, 38213.04467388338, 33066.0, 33458.16354591155, 34013.82993085019, 34096.14759631029, 34178.0, 24853.130140445, 25168.622470662587, 25395.87302063478, 25463.618045729698, 25577.0], "unit": "score", "name": "ext.html", "value": 19258.20750432995}, {"lowerIsBetter": false, "replicates": [356.6380124173963, 360.2632616299667, 362.5250921293106, 364.4260290043181, 371.92189640175565, 14595.343209555569, 15086.77369839452, 15967.201639918016, 19670.0, 20929.581408371843, 17626.823731762677, 20409.285675001378, 20586.0, 20974.89512552439, 21881.562368752657, 5751.166080918275, 6690.397864192221, 6693.431058360045, 6695.296993815652, 6710.16122984627, 4610.884727881813, 6694.631795251284, 7200.38796702281, 7675.577843218621, 7703.38372930167, 7389.963050184741, 7533.547987120763, 7583.393328533704, 7646.961765191167, 7662.578558179298, 7369.520981136209, 7533.924660753377, 7608.391328693719, 7625.161232264447, 7646.61766911655, 7036.366726994544, 7110.893336599956, 7208.49540532163, 7228.421726261887, 7230.385417239489, 25929.61105583418, 26296.342591435176, 26592.86703566489, 27441.86279068612, 27748.02881899144, 1734.9219285132199, 2076.6158260721663, 2434.3914021494625, 2850.7074329149864, 2971.7176868197485, 15181.544553663407, 15444.613884652861, 15480.922595387063, 15608.297626606716, 16425.58936026597, 1828.1316374722035, 1831.377331707226, 1839.7148441991512, 1870.812918708132, 1905.2569497895693, 77610.44779104386, 98191.0, 99576.0, 116654.0, 125880.0, 10797.946010269898, 11029.786723460413, 11033.779324413626, 11039.83440248397, 11117.722056948642, 12264.693382665326, 12562.685932851751, 12621.495140194473, 13393.861521770565, 13442.395092220873, 6475.32009139043, 6594.901076483857, 8035.236652518001, 8521.957390213009, 8625.439346442461, 8603.31173506118, 8635.78410539729, 8659.740207793777, 8688.0, 8790.42862213954, 4457.108578284357, 4533.320001999727, 4535.478419981679, 4584.083183363341, 4585.10590434862, 1837.7243413488084, 1890.5557194059386, 1899.0599653171769, 1911.7419148414785, 1946.8734532255357, 849.1211595998236, 889.2796834563894, 904.4663648447447, 965.7247684409909, 993.8471373207045, 19494.927778972007, 20320.491987700425, 20740.896295518425, 20860.69069486056, 20878.0, 845.9605384290064, 892.1658249536704, 932.3939439364332, 936.1434287626745, 960.7550074730899, 8981.506017168987, 10474.947625261824, 10757.946210269056, 10760.300580462244, 10815.297005694605, 256180.0, 263536.364636355, 284336.0, 372544.0, 585301.2204816932, 118717.0, 121037.0, 121272.36182914527, 121509.0, 123685.0, 1052.9262951593314, 1055.625253035177, 1118.1278602689915, 1134.3817619397448, 1136.2614300704608, 18832.52918676989, 18833.529161771065, 18981.620367592295, 18988.715169272196, 19048.523786904883, 41111.943653528666, 50359.74820125876, 52042.21936670877, 52759.472405275454, 52855.47144528505, 55760.72119639376, 68432.63134737377, 71879.28120718726, 73566.63216683883, 74153.0, 7713.845723085395, 7894.250046245597, 7922.207779222032, 7957.920420795718, 7988.560629165219, 11085.889141108808, 11181.888181118085, 12297.44661490253, 12531.373431328579, 12557.372131393211, 7853.882191767014, 8183.6906095024515, 10873.347599144077, 10983.39591322485, 11258.973384790816, 9964.252681049094, 10650.360978341325, 10653.840192397276, 11026.283291586022, 11081.335119892832, 10430.53062612169, 11315.264507806965, 11400.372979486208, 11535.0, 11562.710932226762, 7547.245175624603, 7842.29419352261, 8001.999750031246, 8004.959975200087, 8041.396895232998, 11126.221164518405, 11165.609203677832, 11356.0915126788, 11389.487473063566, 11395.430228488709], "unit": "score", "name": "jquery.html", "value": 9556.100973302971}, {"lowerIsBetter": false, "replicates": [1352.2697743218662, 1484.2207840883536, 1519.574519134642, 1737.5482374582605, 1932.2753967262286, 7887.5267483951, 8531.27484163846, 8719.258862996638, 8724.258438032759, 8737.95631021844, 8392.412531122824, 8655.826883462343, 8669.21977022068, 8670.739877803677, 8676.0, 2149.9355019349446, 2415.10641062807, 2437.6343548467785, 2468.4939587384542, 2471.9629205561932, 2456.45957889265, 2462.704475462947, 2495.126705653016, 2498.1381423408893, 2502.5495410826043, 2428.6842710447618, 2466.4573793765344, 2467.3214865911837, 2469.234537293436, 2475.170817776047, 2406.097713357491, 2450.0077468625145, 2461.0, 2463.8275320727557, 2465.4329504214043, 2455.054803900511, 2472.4684192898612, 2473.0355161487037, 2485.875706214682, 2494.1893884487613, 8564.657413703506, 8664.133586641348, 8668.046514883357, 8671.219590236846, 8681.2186903179, 5347.224652425377, 5544.695041772701, 5546.195801608785, 5547.916781248285, 5550.555955523589, 3060.1125673554643, 3616.2405894762132, 3649.251903359805, 3725.012871589031, 3751.606081361445, 1060.5704689600648, 1061.124572227915, 1066.1044722433116, 1101.7741363020561, 1110.4780753046055, 11662.0, 11781.528738850435, 11862.762744745056, 11875.762484750343, 11882.702932426671, 4919.1391506486225, 4940.802367905316, 5021.020900924358, 5022.196448568212, 5029.17018691919, 10087.293889427816, 10126.493675316353, 10137.645182418728, 10152.187824973984, 10176.643817466353, 4954.504549545017, 5541.224228607998, 5544.279243698294, 5545.72271386429, 5554.2779438672715, 4474.776261186993, 4528.569785870337, 4533.116042371706, 4536.841210557681, 4756.762161891892, 3921.274564205631, 3947.7236593438183, 3983.6016398359934, 3990.102226998902, 4016.859409920639, 1282.7306265684124, 1318.1102755640097, 1319.070055610792, 1328.7076843094503, 1333.0468714868916, 1299.5516546791341, 1323.0606269548728, 1323.4573824731813, 1331.3210262765865, 1354.5056054540023, 8042.879356809653, 8076.798080047928, 8147.266745992889, 8151.347892168612, 8154.633041513146, 505.91652377357326, 506.0385267990847, 510.12258914666717, 515.4690668611337, 526.5234962359071, 6124.938750612437, 6149.938500615026, 6211.130441738161, 6214.1921550198185, 6222.906656400158, 10267.0, 10672.78654426907, 10673.039426451656, 10691.465426728633, 10768.78462430747, 10282.691519254435, 10510.896355882522, 10579.84130238047, 10639.89360106389, 10668.466576671135, 8252.917470825216, 8279.420440569224, 8284.668613255522, 8358.791030224293, 8360.623771930277, 6739.5619284746335, 7627.084749830056, 7723.497972631761, 7823.100343460575, 7866.0560732710155, 9414.340996130206, 9507.524623768646, 9561.713148605553, 9651.034896510293, 9711.708648740549, 9311.068893110634, 9670.75823104428, 9684.95157524208, 9980.351277166961, 10026.498675066363, 6366.193523889434, 6557.442617377576, 7356.48504604694, 7474.7757567273065, 7492.100947886289, 8059.274665280153, 8129.552874591955, 8224.054233762954, 8227.71203007892, 8238.299744521542, 7212.783616491513, 7324.230955749569, 7327.413806895543, 7463.17905030457, 7469.551826890404, 7140.9285907140265, 7213.314735100157, 7260.382867456326, 7288.635568221674, 7353.448491363276, 7352.0, 7614.314711675976, 7619.276168763959, 7620.733274335372, 7632.732854350294, 6848.7260509579055, 6937.132858392701, 6939.236683964861, 6942.8611427772175, 6963.895541566982, 6904.171499420102, 7053.753118640823, 7056.400205982549, 7056.576605403692, 7061.576305421691], "unit": "score", "name": "mootools.html", "value": 4815.16812882107}, {"lowerIsBetter": false, "replicates": [253.37669333439737, 320.7674436033875, 321.1954055091994, 324.0876931438003, 327.72143677873794, 5328.721106934337, 6437.163168788057, 6466.094746735455, 6563.245226798919, 6585.176852893388, 6476.546641735081, 6522.119513865627, 6536.901946470807, 6537.287025884264, 6553.9841324594645, 3906.277338692337, 4706.411698537683, 4726.385569875912, 4861.319415281863, 4868.707877527342, 4677.06458708258, 4782.713037217761, 4839.056384005103, 4843.5156484351455, 4845.273209018657, 4732.550407711262, 4747.098051370246, 4768.403949506312, 4785.521447855222, 4785.760711964388, 4564.56216291867, 4604.286335617984, 4739.075880203327, 4746.931940313437, 4772.785224664898, 4065.9796701016307, 4083.203775263825, 4084.550699423061, 4095.5290141633795, 4096.938545921814, 6228.096925945758, 6291.307956124822, 6300.842478938017, 6301.08634248036, 6319.210098737658, 5665.603407761459, 5676.347220069662, 5678.886422271573, 5698.40166782486, 5700.37295897451, 6613.503987200979, 6868.072810170613, 6874.793756187322, 6907.896381554281, 6914.651642929631, 4490.797914093873, 4498.685092043558, 4505.301678239878, 4520.095980803852, 4523.819047238107, 7271.963640181765, 7347.706091756377, 7359.264073592652, 7360.411167106618, 7364.852702945965, 4130.554305992879, 4159.7920103994675, 4387.122575484916, 4549.294859296814, 4554.225781617133, 3794.430835374716, 4580.931286030712, 4604.102200070954, 4656.185167595657, 4661.813527458931, 5519.586031047687, 5529.557635389159, 5543.667379957215, 5545.528630066489, 5564.415736347625, 6739.460843132538, 7003.92996070043, 7012.158540975116, 7016.789496315118, 7025.789226323219, 1596.9041857488587, 1601.375463569209, 1617.7007253658112, 1618.9595260118592, 1625.9430919917982, 894.1952242981239, 1023.3706270643501, 1034.1158309645296, 1046.9685909422728, 1047.177965297238, 6347.270063942613, 6503.28463868974, 6508.349165083454, 6515.902261466082, 6523.543351965317, 5696.715164241771, 7297.197308296083, 7314.670839812221, 7329.816754581178, 7335.853282934311, 6379.5215358847345, 6574.769883054166, 6591.307912669196, 6593.86812263752, 6598.505112116611, 3821.636944490269, 3852.152526444178, 3880.631340022693, 3885.786281754474, 3893.2213557288655, 6409.711562979677, 7624.656890439833, 7632.274933881273, 7638.236176382317, 7641.1212710539, 7251.202367739545, 7306.561606303639, 7519.661615227328, 7520.172780994087, 7527.3225409712295, 7554.0, 7611.847763044708, 7613.352865006536, 7614.933909252709, 7623.923760762433, 7320.231375705687, 7322.231165727522, 7330.853382932418, 7337.0828646419195, 7338.743143989935, 5849.707514624167, 6003.45968862787, 6816.795496135124, 7053.4004609608755, 7206.6396680164735, 6506.967465162644, 7269.382102521134, 7521.924780752122, 7583.317501424898, 7592.696292148252, 4585.10590434862, 4595.954040459553, 4604.424446944132, 4610.147122782296, 4611.723296602215, 7006.932954778455, 7203.099612548432, 7209.990601315925, 7322.560646361236, 7325.304096110861, 7020.964895175492, 7051.6474176292, 7064.187618423947, 7073.328033836778, 7099.787006389816, 7041.5564809212965, 7061.576305421486, 7064.399526040139, 7069.9646501767165, 7071.858562828612, 5754.6547207167705, 6568.6058836469965, 6569.9343006571235, 6860.382565569123, 6891.689873955584, 6655.600663960178, 6809.285025072296, 6842.315768423317, 7017.157941046903, 7060.7881763547175, 6084.543659225665, 6266.717997690023, 6846.178458585002, 6851.588904665736, 6870.381665650116], "unit": "score", "name": "prototype.html", "value": 5050.268078572202}, {"lowerIsBetter": false, "replicates": [654.5777973207281, 708.8759467093257, 718.0952000479394, 743.851229754049, 773.0684525147202, 14354.569362919103, 14523.709525809478, 14552.981291309612, 14570.344334504945, 14596.781048284285, 10309.58761649535, 12943.935280323609, 12949.935250323759, 12968.286744229064, 13003.219806811598, 714.731975509184, 728.7412968396222, 869.617368357922, 879.3712495565669, 887.7248053103526, 869.5826003518315, 889.3818795936827, 890.2699786175307, 892.857142857143, 893.1604291965564, 933.9392939458947, 935.2331088507426, 936.2089034765612, 937.9437233765962, 938.755923459902, 747.7420289999968, 916.7753900294471, 931.3154831199063, 934.3973137326454, 935.2331088507426, 692.9237783843773, 694.007569176078, 694.6110178300117, 695.2942763095463, 696.5298423564125, 13825.51610693631, 13899.957503187201, 13906.721865562733, 13929.721405571932, 13966.231857247847, 9957.800843983152, 11908.225965312227, 11967.760644787142, 11999.220050696764, 12145.453454594564, 7924.960375198087, 9497.0, 9582.616695332179, 9607.855882161773, 10186.694399168036, 2708.607251948476, 3143.905682829519, 3197.9411882057316, 3243.5783348164587, 3245.7403407727325, 78995.0, 79472.20527794764, 80767.59616201882, 81705.0, 82130.3573928518, 8974.237189838806, 9001.54992250398, 9018.909810901938, 9130.360874738837, 9218.631254749735, 19349.12928918202, 19349.903250483938, 19358.322458713876, 19367.903160484388, 19393.709094363596, 6825.55633883796, 6836.589804611739, 6858.1084459021, 6971.477139214478, 6980.546264492792, 3743.887683369503, 3789.2989796887664, 3825.196708691206, 3850.422436634471, 3894.1432884765304, 3335.5997280326515, 3387.4241378965635, 3399.6770306820813, 3403.540522029544, 3406.795592264472, 612.3662009819905, 625.565232163651, 628.9622622642564, 632.8670979094442, 645.9903101453482, 531.4871149340827, 584.155894732108, 614.1789593854244, 620.919280493542, 626.7837596029362, 7649.388048956182, 7951.84096318082, 8102.837943241102, 8308.792280192923, 8330.458520196167, 506.344284152024, 523.5262087810538, 525.6777168296406, 600.3486217454024, 629.9653519056404, 3207.230264736493, 3483.7387195960405, 3733.1973625670066, 3737.289914916157, 3823.751456155341, 92967.0, 93297.53351233201, 93456.0, 93623.0, 95442.52278738562, 81792.0, 82402.0, 82509.17490825136, 83294.3341133174, 83483.0, 68211.0, 68463.97304040444, 68765.93702188942, 68986.0, 69620.3037969624, 7451.5901625411125, 7487.513311634726, 7706.653200606098, 7712.228777122243, 7788.026496687914, 36241.818790905876, 50053.49946500634, 51850.0, 52201.694957626365, 53218.93562128813, 66424.66787666031, 67108.0, 67224.0, 71333.64333178301, 73209.53580928245, 9156.130167634064, 9194.9540252301, 9230.215431688383, 9231.261499079923, 9254.25965922738, 9890.258230632875, 9914.157296629868, 10590.258681892194, 11752.941235293769, 12497.562585309834, 10939.617113400993, 10947.616833410792, 11069.391183484986, 11072.889271107186, 11226.989570938655, 10754.784904301714, 10760.569577216824, 10834.729131771453, 10853.837192441963, 10992.0, 10375.896241037795, 10702.143828493547, 10842.512086956263, 10878.0, 10926.836097458703, 9087.636494540144, 9201.631934722536, 9303.395279306824, 9731.756706082404, 9803.705888823346, 8348.87476687838, 9490.905090949002, 9653.276004299565, 9691.97138314791, 9897.50512474359], "unit": "score", "name": "yui.html", "value": 6595.99897029109}], "name": "dromaeo_css", "value": 7411.24677989743}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [139.0, 155.0, 110.0, 110.0, 110.0, 111.0, 115.0, 110.0, 110.0, 111.0], "unit": "score", "name": "ai-astar", "value": 118.1}, {"lowerIsBetter": true, "replicates": [155.0, 122.0, 144.0, 158.0, 118.0, 144.0, 140.0, 117.0, 161.0, 117.0], "unit": "score", "name": "audio-beat-detection", "value": 137.6}, {"lowerIsBetter": true, "replicates": [183.0, 184.0, 184.0, 187.0, 185.0, 187.0, 185.0, 187.0, 179.0, 184.0], "unit": "score", "name": "audio-dft", "value": 184.5}, {"lowerIsBetter": true, "replicates": [74.0, 79.0, 86.0, 79.0, 58.0, 57.0, 61.0, 80.0, 78.0, 67.0], "unit": "score", "name": "audio-fft", "value": 71.9}, {"lowerIsBetter": true, "replicates": [89.0, 97.0, 124.0, 78.0, 79.0, 83.0, 115.0, 79.0, 77.0, 117.0], "unit": "score", "name": "audio-oscillator", "value": 93.8}, {"lowerIsBetter": true, "replicates": [85.0, 91.0, 85.0, 91.0, 85.0, 90.0, 85.0, 91.0, 85.0, 91.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 87.9}, {"lowerIsBetter": true, "replicates": [94.0, 95.0, 94.0, 95.0, 94.0, 94.0, 95.0, 94.0, 94.0, 93.0], "unit": "score", "name": "imaging-darkroom", "value": 94.2}, {"lowerIsBetter": true, "replicates": [86.0, 85.0, 87.0, 87.0, 83.0, 87.0, 86.0, 87.0, 85.0, 85.0], "unit": "score", "name": "imaging-desaturate", "value": 85.8}, {"lowerIsBetter": true, "replicates": [56.0, 55.0, 54.0, 54.0, 54.0, 54.0, 55.0, 64.0, 53.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 55.2}, {"lowerIsBetter": true, "replicates": [65.0, 63.0, 71.0, 85.0, 91.0, 59.0, 58.0, 58.0, 90.0, 93.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 73.3}, {"lowerIsBetter": true, "replicates": [83.0, 83.0, 82.0, 83.0, 87.0, 106.0, 106.0, 108.0, 103.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 92.4}, {"lowerIsBetter": true, "replicates": [129.0, 131.0, 130.0, 117.0, 130.0, 118.0, 115.0, 113.0, 114.0, 128.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 122.5}, {"lowerIsBetter": true, "replicates": [123.0, 127.0, 139.0, 139.0, 139.0, 127.0, 140.0, 138.0, 151.0, 174.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 139.7}, {"lowerIsBetter": true, "replicates": [65.0, 68.0, 67.0, 65.0, 68.0, 63.0, 82.0, 94.0, 96.0, 96.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 76.4}], "name": "kraken", "value": 1433.3000000000002}]} 11:08:30 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,59]]", "result": "1433.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,59]]", "result": "7411.25"}}} 11:08:30 INFO - Return code: 0 11:08:30 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 11:08:30 INFO - # TBPL SUCCESS # 11:08:30 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 11:08:30 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 11:08:30 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 11:08:30 INFO - 2016-02-19 11:08:30.940 screenresolution[2601:21846] starting screenresolution argv=screenresolution get 11:08:30 INFO - 2016-02-19 11:08:30.942 screenresolution[2601:21846] Display 0: 1600x1200x32@60 11:08:30 INFO - 2016-02-19 11:08:30.948 screenresolution[2602:21849] starting screenresolution argv=screenresolution list 11:08:30 INFO - Available Modes on Display 0 11:08:30 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 11:08:30 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 11:08:30 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 11:08:30 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 11:08:31 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 11:08:31 INFO - Intel Iris: 11:08:31 INFO - Chipset Model: Intel Iris 11:08:31 INFO - Type: GPU 11:08:31 INFO - Bus: Built-In 11:08:31 INFO - VRAM (Dynamic, Max): 1536 MB 11:08:31 INFO - Vendor: Intel (0x8086) 11:08:31 INFO - Device ID: 0x0a2e 11:08:31 INFO - Revision ID: 0x0009 11:08:31 INFO - Displays: 11:08:31 INFO - Display: 11:08:31 INFO - Resolution: 1600 x 1200 @ 60 Hz 11:08:31 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 11:08:31 INFO - Display Serial Number: 1600x1200 60 11:08:31 INFO - Main Display: Yes 11:08:31 INFO - Mirror: Off 11:08:31 INFO - Online: Yes 11:08:31 INFO - Rotation: Supported 11:08:31 INFO - Return code: 0 11:08:31 INFO - Running post-action listener: _resource_record_post_action 11:08:31 INFO - Running post-run listener: _resource_record_post_run 11:08:32 INFO - Total resource usage - Wall time: 1207s; CPU: 53.0%; Read bytes: 241664; Write bytes: 704759296; Read time: 4; Write time: 1901 11:08:32 INFO - install - Wall time: 35s; CPU: 55.0%; Read bytes: 392833536; Write bytes: 386848256; Read time: 29538; Write time: 691 11:08:32 INFO - run-tests - Wall time: 1173s; CPU: 53.0%; Read bytes: 241664; Write bytes: 297955328; Read time: 4; Write time: 1163 11:08:32 INFO - Running post-run listener: _upload_blobber_files 11:08:32 INFO - Blob upload gear active. 11:08:32 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:08:32 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 11:08:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:08:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:08:32 INFO - (blobuploader) - INFO - Open directory for files ... 11:08:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:08:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:08:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:08:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:08:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:08:33 INFO - (blobuploader) - INFO - Done attempting. 11:08:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 11:08:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:08:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:08:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:08:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:08:34 INFO - (blobuploader) - INFO - Done attempting. 11:08:34 INFO - (blobuploader) - INFO - Iteration through files over. 11:08:34 INFO - Return code: 0 11:08:34 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:08:34 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:08:34 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/318ad701b821eb94a8ce8b9d54913f6d3af29e0f85a2a103d298a3dfe5625541f7d2c1fa89fbc2643945614d66ddd023546d848cd1a3d48352feb67ab60a532d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2a8535f7790bdc5f4964f29c90345a2fb110d38afe7c9de385e3c5c0edc809a735242def7101359f927a5198a208a8fdd473f5c5cfd254c2946c2939ad076f93"} 11:08:34 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:08:34 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:08:34 INFO - Contents: 11:08:34 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/318ad701b821eb94a8ce8b9d54913f6d3af29e0f85a2a103d298a3dfe5625541f7d2c1fa89fbc2643945614d66ddd023546d848cd1a3d48352feb67ab60a532d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2a8535f7790bdc5f4964f29c90345a2fb110d38afe7c9de385e3c5c0edc809a735242def7101359f927a5198a208a8fdd473f5c5cfd254c2946c2939ad076f93"} 11:08:34 INFO - Running post-run listener: copy_logs_to_upload_dir 11:08:34 INFO - Copying logs to upload dir... 11:08:34 INFO - mkdir: /builds/slave/test/build/upload/logs 11:08:34 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1263.672340 ========= master_lag: 1.18 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2016-02-19 11:08:35.889153) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 1 secs) (at 2016-02-19 11:08:35.892571) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test/properties RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/318ad701b821eb94a8ce8b9d54913f6d3af29e0f85a2a103d298a3dfe5625541f7d2c1fa89fbc2643945614d66ddd023546d848cd1a3d48352feb67ab60a532d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2a8535f7790bdc5f4964f29c90345a2fb110d38afe7c9de385e3c5c0edc809a735242def7101359f927a5198a208a8fdd473f5c5cfd254c2946c2939ad076f93"} build_url:https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011485 build_url: 'https://queue.taskcluster.net/v1/task/fQesfe84RAOlUiGLwzH3cg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/318ad701b821eb94a8ce8b9d54913f6d3af29e0f85a2a103d298a3dfe5625541f7d2c1fa89fbc2643945614d66ddd023546d848cd1a3d48352feb67ab60a532d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2a8535f7790bdc5f4964f29c90345a2fb110d38afe7c9de385e3c5c0edc809a735242def7101359f927a5198a208a8fdd473f5c5cfd254c2946c2939ad076f93"}' ========= master_lag: 1.72 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 1 secs) (at 2016-02-19 11:08:37.626422) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-19 11:08:37.626896) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.XM5J8ekcNO/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.uWyyeGWzEa/Listeners TMPDIR=/var/folders/bj/hz090k0x51d88nc483dscv7m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.004999 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-19 11:08:37.681756) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-19 11:08:37.682069) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-19 11:08:37.684639) ========= ========= Total master_lag: 3.78 =========