builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0136 starttime: 1459987720.74 results: success (0) buildid: 20160406160854 builduid: 1467794a4825431096c8d01a7866e9ee revision: 133d8859d7b5e7d44d74c66aaa52c2da30cab3c4 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.764170) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.764813) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.765127) ========= 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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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.005677 basedir: '/builds/slave/test' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.802166) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.802496) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.818483) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.818891) ========= 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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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.005277 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.868133) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.868441) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.868816) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:40.869108) ========= 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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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-04-06 17:08:40-- 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% 148M=0s 2016-04-06 17:08:41 (148 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.159094 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.044158) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.044479) ========= 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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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.018975 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.095167) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.095521) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 133d8859d7b5e7d44d74c66aaa52c2da30cab3c4 --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 133d8859d7b5e7d44d74c66aaa52c2da30cab3c4 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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-04-06 17:08:41,170 truncating revision to first 12 chars 2016-04-06 17:08:41,170 Setting DEBUG logging. 2016-04-06 17:08:41,170 attempt 1/10 2016-04-06 17:08:41,170 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/133d8859d7b5?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-06 17:08:41,475 unpacking tar archive at: fx-team-133d8859d7b5/testing/mozharness/ program finished with exit code 0 elapsedTime=0.544824 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.664840) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.665239) ========= echo 133d8859d7b5e7d44d74c66aaa52c2da30cab3c4 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'133d8859d7b5e7d44d74c66aaa52c2da30cab3c4'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 133d8859d7b5e7d44d74c66aaa52c2da30cab3c4 program finished with exit code 0 elapsedTime=0.005181 script_repo_revision: '133d8859d7b5e7d44d74c66aaa52c2da30cab3c4' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.722708) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.723041) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-06 17:08:41.742352) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 43 secs) (at 2016-04-06 17:08:41.742716) ========= /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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:08:41 INFO - MultiFileLogger online at 20160406 17:08:41 in /builds/slave/test 17:08:41 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 17:08:41 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:08:41 INFO - {'append_to_log': False, 17:08:41 INFO - 'base_work_dir': '/builds/slave/test', 17:08:41 INFO - 'blob_upload_branch': 'Fx-Team', 17:08:41 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:08:41 INFO - 'branch': 'Fx-Team', 17:08:41 INFO - 'buildbot_json_path': 'buildprops.json', 17:08:41 INFO - 'config_files': ('talos/mac_config.py',), 17:08:41 INFO - 'default_actions': ('clobber', 17:08:41 INFO - 'read-buildbot-config', 17:08:41 INFO - 'download-and-extract', 17:08:41 INFO - 'populate-webroot', 17:08:41 INFO - 'create-virtualenv', 17:08:41 INFO - 'install', 17:08:41 INFO - 'run-tests'), 17:08:41 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:08:41 INFO - 'download_minidump_stackwalk': True, 17:08:41 INFO - 'download_symbols': 'ondemand', 17:08:41 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:08:41 INFO - 'tooltool.py': '/tools/tooltool.py', 17:08:41 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:08:41 INFO - '/tools/misc-python/virtualenv.py')}, 17:08:41 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:08:41 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:08:41 INFO - 'installer_path': 'installer.exe', 17:08:41 INFO - 'log_level': 'info', 17:08:41 INFO - 'log_name': 'talos', 17:08:41 INFO - 'log_to_console': True, 17:08:41 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 17:08:41 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 17:08:41 INFO - 'opt_config_files': (), 17:08:41 INFO - 'pip_index': False, 17:08:41 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:08:41 INFO - 'cmd': ('bash', 17:08:41 INFO - '-c', 17:08:41 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:08:41 INFO - 'enabled': True, 17:08:41 INFO - 'halt_on_failure': False, 17:08:41 INFO - 'name': 'check_screen_resolution'},), 17:08:41 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:08:41 INFO - 'cmd': ('bash', 17:08:41 INFO - '-c', 17:08:41 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:08:41 INFO - 'enabled': True, 17:08:41 INFO - 'halt_on_failure': False, 17:08:41 INFO - 'name': 'check_screen_resolution'},), 17:08:41 INFO - 'run_cmd_checks_enabled': True, 17:08:41 INFO - 'sps_profile': False, 17:08:41 INFO - 'sps_profile_interval': 0, 17:08:41 INFO - 'suite': 'dromaeojs', 17:08:41 INFO - 'system_bits': '32', 17:08:41 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:08:41 INFO - 'title': 't-yosemite-r7-0136', 17:08:41 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:08:41 INFO - 'use_talos_json': True, 17:08:41 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:08:41 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:08:41 INFO - 'work_dir': 'build'} 17:08:41 INFO - ##### 17:08:41 INFO - ##### Running clobber step. 17:08:41 INFO - ##### 17:08:41 INFO - Running pre-action listener: _resource_record_pre_action 17:08:41 INFO - Running main action method: clobber 17:08:41 INFO - rmtree: /builds/slave/test/build 17:08:41 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:08:43 INFO - Running post-action listener: _resource_record_post_action 17:08:43 INFO - ##### 17:08:43 INFO - ##### Running read-buildbot-config step. 17:08:43 INFO - ##### 17:08:43 INFO - Running pre-action listener: _resource_record_pre_action 17:08:43 INFO - Running main action method: read_buildbot_config 17:08:43 INFO - Using buildbot properties: 17:08:43 INFO - { 17:08:43 INFO - "project": "", 17:08:43 INFO - "product": "firefox", 17:08:43 INFO - "script_repo_revision": "production", 17:08:43 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 17:08:43 INFO - "repository": "", 17:08:43 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 17:08:43 INFO - "buildid": "20160406160854", 17:08:43 INFO - "pgo_build": "False", 17:08:43 INFO - "basedir": "/builds/slave/test", 17:08:43 INFO - "buildnumber": 623, 17:08:43 INFO - "slavename": "t-yosemite-r7-0136", 17:08:43 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 17:08:43 INFO - "platform": "yosemite_r7", 17:08:43 INFO - "scheduler": "tests-fx-team-macosx64-talos", 17:08:43 INFO - "branch": "fx-team", 17:08:43 INFO - "repo_path": "integration/fx-team", 17:08:43 INFO - "revision": "133d8859d7b5e7d44d74c66aaa52c2da30cab3c4", 17:08:43 INFO - "stage_platform": "macosx64", 17:08:43 INFO - "builduid": "1467794a4825431096c8d01a7866e9ee", 17:08:43 INFO - "slavebuilddir": "test" 17:08:43 INFO - } 17:08:43 INFO - Found installer url https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg. 17:08:43 INFO - Running post-action listener: _resource_record_post_action 17:08:43 INFO - ##### 17:08:43 INFO - ##### Running download-and-extract step. 17:08:43 INFO - ##### 17:08:43 INFO - Running pre-action listener: _resource_record_pre_action 17:08:43 INFO - Running main action method: download_and_extract 17:08:43 INFO - mkdir: /builds/slave/test/build/tests 17:08:43 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')]} 17:08:43 INFO - https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 17:08:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 17:08:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 17:08:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 17:08:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json'}, attempt #1 17:08:44 INFO - Downloaded 1199 bytes. 17:08:44 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 17:08:44 INFO - Using the following test package requirements: 17:08:44 INFO - {u'common': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 17:08:44 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:08:44 INFO - u'firefox-48.0a1.en-US.mac.cppunittest.tests.zip'], 17:08:44 INFO - u'gtest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:08:44 INFO - u'firefox-48.0a1.en-US.mac.gtest.tests.zip'], 17:08:44 INFO - u'jittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:08:44 INFO - u'jsshell-mac.zip'], 17:08:44 INFO - u'mochitest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:08:44 INFO - u'firefox-48.0a1.en-US.mac.mochitest.tests.zip'], 17:08:44 INFO - u'mozbase': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 17:08:44 INFO - u'reftest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:08:44 INFO - u'firefox-48.0a1.en-US.mac.reftest.tests.zip'], 17:08:44 INFO - u'talos': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:08:44 INFO - u'firefox-48.0a1.en-US.mac.talos.tests.zip'], 17:08:44 INFO - u'web-platform': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:08:44 INFO - u'firefox-48.0a1.en-US.mac.web-platform.tests.zip'], 17:08:44 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:08:44 INFO - u'firefox-48.0a1.en-US.mac.xpcshell.tests.zip']} 17:08:44 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip'] for test suite category: common 17:08: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')]} 17:08:44 INFO - https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 17:08:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:08:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:08:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:08:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 17:08:46 INFO - Downloaded 17970646 bytes. 17:08:46 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:08:46 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 17:08:49 INFO - Return code: 0 17:08:49 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip', u'firefox-48.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 17:08:49 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')]} 17:08:49 INFO - https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 17:08:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:08:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:08:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:08:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 17:08:58 INFO - Downloaded 17970646 bytes. 17:08:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:08:58 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 17:09:02 INFO - Return code: 0 17:09:02 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')]} 17:09:02 INFO - https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 17:09:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:09:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:09:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:09:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip'}, attempt #1 17:09:29 INFO - Downloaded 10847617 bytes. 17:09:29 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:09:29 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 17:09:29 INFO - Return code: 0 17:09:29 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')]} 17:09:29 INFO - https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 17:09:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:09:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:09:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg 17:09:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg'}, attempt #1 17:09:38 INFO - Downloaded 108914706 bytes. 17:09:38 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:09:38 INFO - mkdir: /builds/slave/test/properties 17:09:38 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:09:38 INFO - Writing to file /builds/slave/test/properties/build_url 17:09:38 INFO - Contents: 17:09:38 INFO - build_url:https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:09:40 INFO - Running post-action listener: _resource_record_post_action 17:09:40 INFO - Running post-action listener: set_extra_try_arguments 17:09:40 INFO - ##### 17:09:40 INFO - ##### Running populate-webroot step. 17:09:40 INFO - ##### 17:09:40 INFO - Running pre-action listener: _resource_record_pre_action 17:09:40 INFO - Running main action method: populate_webroot 17:09:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:09:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:09:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:09:40 INFO - '--tppagecycles', 17:09:40 INFO - '7'], 17:09:40 INFO - 'tests': ['tsvgm']}}, 17:09:40 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:09:40 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 17:09:40 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:09:40 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 17:09:40 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:09:40 INFO - 'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:09:40 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:09:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:09:40 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:09:40 INFO - 'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['damp', 'tps']}, 17:09:40 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:09:40 INFO - 'tests': ['damp', 'tps']}, 17:09:40 INFO - 'g3': {'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['dromaeo_dom']}, 17:09:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:09:40 INFO - 'other': {'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['a11yr', 17:09:40 INFO - 'ts_paint', 17:09:40 INFO - 'tpaint', 17:09:40 INFO - 'sessionrestore', 17:09:40 INFO - 'sessionrestore_no_auto_restore', 17:09:40 INFO - 'tabpaint']}, 17:09:40 INFO - 'other-e10s': {'tests': ['a11yr', 17:09:40 INFO - 'ts_paint', 17:09:40 INFO - 'tpaint', 17:09:40 INFO - 'sessionrestore', 17:09:40 INFO - 'sessionrestore_no_auto_restore', 17:09:40 INFO - 'tabpaint']}, 17:09:40 INFO - 'other-e10s_l64': {'tests': ['a11yr', 17:09:40 INFO - 'ts_paint', 17:09:40 INFO - 'tpaint', 17:09:40 INFO - 'sessionrestore', 17:09:40 INFO - 'sessionrestore_no_auto_restore', 17:09:40 INFO - 'tabpaint']}, 17:09:40 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 17:09:40 INFO - 'ts_paint', 17:09:40 INFO - 'tpaint', 17:09:40 INFO - 'sessionrestore', 17:09:40 INFO - 'sessionrestore_no_auto_restore', 17:09:40 INFO - 'tabpaint']}, 17:09:40 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['a11yr', 17:09:40 INFO - 'ts_paint', 17:09:40 INFO - 'tpaint', 17:09:40 INFO - 'sessionrestore', 17:09:40 INFO - 'sessionrestore_no_auto_restore', 17:09:40 INFO - 'tabpaint']}, 17:09:40 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['a11yr', 17:09:40 INFO - 'ts_paint', 17:09:40 INFO - 'tpaint', 17:09:40 INFO - 'sessionrestore', 17:09:40 INFO - 'sessionrestore_no_auto_restore', 17:09:40 INFO - 'tabpaint']}, 17:09:40 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['tsvgx', 17:09:40 INFO - 'tsvgr_opacity', 17:09:40 INFO - 'tart', 17:09:40 INFO - 'tscrollx', 17:09:40 INFO - 'cart']}, 17:09:40 INFO - 'svgr-e10s': {'tests': ['tsvgx', 17:09:40 INFO - 'tsvgr_opacity', 17:09:40 INFO - 'tart', 17:09:40 INFO - 'tscrollx', 17:09:40 INFO - 'cart']}, 17:09:40 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:09:40 INFO - 'talos_options': ['--disable-e10s'], 17:09:40 INFO - 'tests': ['tp5o']}, 17:09:40 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:09:40 INFO - 'tests': ['tp5o']}, 17:09:40 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:09:40 INFO - 'talos_options': ['--disable-e10s', 17:09:40 INFO - '--xperf_path', 17:09:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:09:40 INFO - 'tests': ['tp5n']}, 17:09:40 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:09:40 INFO - 'talos_options': ['--xperf_path', 17:09:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:09:40 INFO - 'tests': ['tp5n']}}, 17:09:40 INFO - 'talos.zip': {'path': '', 17:09:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:09:40 INFO - Running post-action listener: _resource_record_post_action 17:09:40 INFO - ##### 17:09:40 INFO - ##### Running create-virtualenv step. 17:09:40 INFO - ##### 17:09:40 INFO - Running pre-action listener: _resource_record_pre_action 17:09:40 INFO - Running main action method: create_virtualenv 17:09:40 INFO - Creating virtualenv /builds/slave/test/build/venv 17:09:40 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 17:09:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:09:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:09:40 INFO - Using real prefix '/tools/python27' 17:09:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:09:41 INFO - Installing distribute.............................................................................................................................................................................................done. 17:09:44 INFO - Installing pip.................done. 17:09:44 INFO - Return code: 0 17:09:44 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:09: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')]} 17:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:09:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09: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')]} 17:09:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:09:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09:44 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:09:44 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 17:09:44 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 17:09:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:09:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:09:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:09:44 INFO - 'HOME': '/Users/cltbld', 17:09:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:09:44 INFO - 'LOGNAME': 'cltbld', 17:09:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:09:44 INFO - 'MOZ_NO_REMOTE': '1', 17:09:44 INFO - 'NO_EM_RESTART': '1', 17:09:44 INFO - 'PAGER': '/bin/cat', 17:09:44 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:09:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:09:44 INFO - 'PWD': '/builds/slave/test', 17:09:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:09:44 INFO - 'SHELL': '/bin/bash', 17:09:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:09:44 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:09:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:09:44 INFO - 'USER': 'cltbld', 17:09:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:09:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:09:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:09:44 INFO - 'XPC_FLAGS': '0x0', 17:09:44 INFO - 'XPC_SERVICE_NAME': '0', 17:09:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:09:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:09:44 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 17:09:44 INFO - Cleaning up... 17:09:44 INFO - Return code: 0 17:09:44 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 17:09: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')]} 17:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:09:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09: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')]} 17:09:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:09:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09:44 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:09:44 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 17:09:44 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 17:09:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:09:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:09:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:09:44 INFO - 'HOME': '/Users/cltbld', 17:09:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:09:44 INFO - 'LOGNAME': 'cltbld', 17:09:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:09:44 INFO - 'MOZ_NO_REMOTE': '1', 17:09:44 INFO - 'NO_EM_RESTART': '1', 17:09:44 INFO - 'PAGER': '/bin/cat', 17:09:44 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:09:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:09:44 INFO - 'PWD': '/builds/slave/test', 17:09:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:09:44 INFO - 'SHELL': '/bin/bash', 17:09:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:09:44 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:09:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:09:44 INFO - 'USER': 'cltbld', 17:09:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:09:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:09:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:09:44 INFO - 'XPC_FLAGS': '0x0', 17:09:44 INFO - 'XPC_SERVICE_NAME': '0', 17:09:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:09:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:09:45 INFO - Downloading/unpacking psutil>=0.7.1 17:09:45 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 17:09:45 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 17:09:45 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 17:09:45 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 17:09:45 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 17:09:45 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 17:09:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:09:47 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:09:47 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:09:47 INFO - Installing collected packages: psutil 17:09:47 INFO - Running setup.py install for psutil 17:09:47 INFO - building 'psutil._psutil_osx' extension 17:09:47 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 17:09:47 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 17:09:48 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 17:09:48 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 17:09:48 INFO - building 'psutil._psutil_posix' extension 17:09:48 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 17:09:48 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 17:09:48 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 17:09:48 INFO - ^ 17:09:48 INFO - 1 warning generated. 17:09:48 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 17:09:48 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:09:48 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:09:48 INFO - Successfully installed psutil 17:09:48 INFO - Cleaning up... 17:09:48 INFO - Return code: 0 17:09:48 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 17:09:48 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')]} 17:09:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:09:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09:48 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')]} 17:09:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:09:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09:48 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:09:48 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 17:09:48 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 17:09:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:09:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:09:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:09:48 INFO - 'HOME': '/Users/cltbld', 17:09:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:09:48 INFO - 'LOGNAME': 'cltbld', 17:09:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:09:48 INFO - 'MOZ_NO_REMOTE': '1', 17:09:48 INFO - 'NO_EM_RESTART': '1', 17:09:48 INFO - 'PAGER': '/bin/cat', 17:09:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:09:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:09:48 INFO - 'PWD': '/builds/slave/test', 17:09:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:09:48 INFO - 'SHELL': '/bin/bash', 17:09:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:09:48 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:09:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:09:48 INFO - 'USER': 'cltbld', 17:09:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:09:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:09:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:09:48 INFO - 'XPC_FLAGS': '0x0', 17:09:48 INFO - 'XPC_SERVICE_NAME': '0', 17:09:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:09:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:09:48 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 17:09:48 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 17:09:48 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 17:09:48 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 17:09:48 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 17:09:48 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 17:09:48 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 17:09:51 INFO - Downloading mozsystemmonitor-0.0.tar.gz 17:09:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:09:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 17:09:51 INFO - Installing collected packages: mozsystemmonitor 17:09:51 INFO - Running setup.py install for mozsystemmonitor 17:09:51 INFO - Successfully installed mozsystemmonitor 17:09:51 INFO - Cleaning up... 17:09:51 INFO - Return code: 0 17:09:51 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:09:51 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')]} 17:09:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:09:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09:51 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')]} 17:09:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:09:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09:51 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:09:51 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 17:09:51 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 17:09:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:09:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:09:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:09:51 INFO - 'HOME': '/Users/cltbld', 17:09:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:09:51 INFO - 'LOGNAME': 'cltbld', 17:09:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:09:51 INFO - 'MOZ_NO_REMOTE': '1', 17:09:51 INFO - 'NO_EM_RESTART': '1', 17:09:51 INFO - 'PAGER': '/bin/cat', 17:09:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:09:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:09:51 INFO - 'PWD': '/builds/slave/test', 17:09:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:09:51 INFO - 'SHELL': '/bin/bash', 17:09:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:09:51 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:09:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:09:51 INFO - 'USER': 'cltbld', 17:09:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:09:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:09:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:09:51 INFO - 'XPC_FLAGS': '0x0', 17:09:51 INFO - 'XPC_SERVICE_NAME': '0', 17:09:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:09:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:09:51 INFO - Downloading/unpacking blobuploader==1.2.4 17:09:51 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 17:09:51 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 17:09:51 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 17:09:51 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 17:09:51 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 17:09:51 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 17:09:54 INFO - Downloading blobuploader-1.2.4.tar.gz 17:09:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:09:54 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:09: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 17:09: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 17:09: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 17:09: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 17:09: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 17:09: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 17:09:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:09:54 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:09: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 17:09: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 17:09: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 17:09: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 17:09: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 17:09: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 17:09:55 INFO - Downloading docopt-0.6.1.tar.gz 17:09:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:09:55 INFO - Installing collected packages: blobuploader, requests, docopt 17:09:55 INFO - Running setup.py install for blobuploader 17:09:55 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:09:55 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:09:55 INFO - Running setup.py install for requests 17:09:56 INFO - Running setup.py install for docopt 17:09:56 INFO - Successfully installed blobuploader requests docopt 17:09:56 INFO - Cleaning up... 17:09:56 INFO - Return code: 0 17:09:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:09:56 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')]} 17:09:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:09:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09:56 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')]} 17:09:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:09:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:09:56 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:09:56 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 17:09:56 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 17:09:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:09:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:09:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:09:56 INFO - 'HOME': '/Users/cltbld', 17:09:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:09:56 INFO - 'LOGNAME': 'cltbld', 17:09:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:09:56 INFO - 'MOZ_NO_REMOTE': '1', 17:09:56 INFO - 'NO_EM_RESTART': '1', 17:09:56 INFO - 'PAGER': '/bin/cat', 17:09:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:09:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:09:56 INFO - 'PWD': '/builds/slave/test', 17:09:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:09:56 INFO - 'SHELL': '/bin/bash', 17:09:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:09:56 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:09:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:09:56 INFO - 'USER': 'cltbld', 17:09:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:09:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:09:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:09:56 INFO - 'XPC_FLAGS': '0x0', 17:09:56 INFO - 'XPC_SERVICE_NAME': '0', 17:09:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:09:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:09:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:09:56 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-3mcYEa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:09:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:09:56 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-Kw6mTI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:09:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:09:56 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-w4YUGf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:09:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:09:56 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-BNcboQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:09:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:09:56 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-wozSzn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-dCO7Me-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-iNTGAn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-LzEgra-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-A2TnW5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-077AdN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-2I1Zsp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-RgGm13-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-XzndYz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-6cJTr1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:09:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:09:57 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-jbxoz1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:09:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:09:58 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-131Xcp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:09:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:09:58 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-ass_Gc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:09:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:09:58 INFO - Running setup.py install for manifestparser 17:09:58 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:09:58 INFO - Running setup.py install for mozcrash 17:09:58 INFO - Running setup.py install for mozdebug 17:09:58 INFO - Running setup.py install for mozdevice 17:09:58 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 17:09:58 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:09:58 INFO - Running setup.py install for mozfile 17:09:59 INFO - Running setup.py install for mozhttpd 17:09:59 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:09:59 INFO - Running setup.py install for mozinfo 17:09:59 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:09:59 INFO - Running setup.py install for mozInstall 17:09:59 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:09:59 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:09:59 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:09:59 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:09:59 INFO - Running setup.py install for mozleak 17:09:59 INFO - Running setup.py install for mozlog 17:09:59 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:09:59 INFO - Running setup.py install for moznetwork 17:09:59 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:09:59 INFO - Running setup.py install for mozprocess 17:10:00 INFO - Running setup.py install for mozprofile 17:10:00 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:10:00 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:10:00 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:10:00 INFO - Running setup.py install for mozrunner 17:10:00 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:10:00 INFO - Running setup.py install for mozscreenshot 17:10:00 INFO - Running setup.py install for moztest 17:10:00 INFO - Running setup.py install for mozversion 17:10:00 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:10:00 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:10:00 INFO - Cleaning up... 17:10:00 INFO - Return code: 0 17:10:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:10:00 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')]} 17:10:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:10:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:10:00 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')]} 17:10:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:10:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:10:00 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:10:00 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 17:10:00 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 17:10:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:10:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:10:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:10:00 INFO - 'HOME': '/Users/cltbld', 17:10:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:10:00 INFO - 'LOGNAME': 'cltbld', 17:10:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:10:00 INFO - 'MOZ_NO_REMOTE': '1', 17:10:00 INFO - 'NO_EM_RESTART': '1', 17:10:00 INFO - 'PAGER': '/bin/cat', 17:10:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:10:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:10:00 INFO - 'PWD': '/builds/slave/test', 17:10:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:10:00 INFO - 'SHELL': '/bin/bash', 17:10:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:10:00 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:10:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:10:00 INFO - 'USER': 'cltbld', 17:10:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:10:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:10:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:10:00 INFO - 'XPC_FLAGS': '0x0', 17:10:00 INFO - 'XPC_SERVICE_NAME': '0', 17:10:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:10:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-NBzM0G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:10:01 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)) 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-Z5grqH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:10:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-bigKaW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:10:01 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)) 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-sgZXRF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:10:01 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)) 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-AoDAOA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:10:01 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)) 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-UQitR5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:10:01 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)) 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-2pJRep-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:10:01 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)) 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-K1As80-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:10:01 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)) 17:10:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:10:01 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-_8UBfO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:10:02 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)) 17:10:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:10:02 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-bevybP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:10:02 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)) 17:10:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:10:02 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-2Wa5jz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:10:02 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)) 17:10:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:10:02 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-78W0Kr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:10:02 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)) 17:10:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:10:02 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-b6_EX4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:10:02 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)) 17:10:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:10:02 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-foJ7dN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:10:02 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)) 17:10:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:10:02 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-fHFo0s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:10:02 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)) 17:10:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:10:02 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-mXVteJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:10:02 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)) 17:10:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:10:02 INFO - Running setup.py (path:/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/pip-zka63a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:10:02 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)) 17:10:02 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:10:02 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:10:02 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)) 17:10:02 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)) 17:10:02 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)) 17:10:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:10:02 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 17:10:02 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 17:10:02 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 17:10:02 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 17:10:02 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 17:10:02 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 17:10:05 INFO - Downloading blessings-1.6.tar.gz 17:10:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:10:05 INFO - Installing collected packages: blessings 17:10:05 INFO - Running setup.py install for blessings 17:10:05 INFO - Successfully installed blessings 17:10:05 INFO - Cleaning up... 17:10:05 INFO - Return code: 0 17:10:05 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:10:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:10:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:10:05 INFO - Reading from file tmpfile_stdout 17:10:05 INFO - Current package versions: 17:10:05 INFO - blessings == 1.6 17:10:05 INFO - blobuploader == 1.2.4 17:10:05 INFO - docopt == 0.6.1 17:10:05 INFO - manifestparser == 1.1 17:10:05 INFO - mozInstall == 1.12 17:10:05 INFO - mozcrash == 0.17 17:10:05 INFO - mozdebug == 0.1 17:10:05 INFO - mozdevice == 0.48 17:10:05 INFO - mozfile == 1.2 17:10:05 INFO - mozhttpd == 0.7 17:10:05 INFO - mozinfo == 0.9 17:10:05 INFO - mozleak == 0.1 17:10:05 INFO - mozlog == 3.1 17:10:05 INFO - moznetwork == 0.27 17:10:05 INFO - mozprocess == 0.22 17:10:05 INFO - mozprofile == 0.28 17:10:05 INFO - mozrunner == 6.11 17:10:05 INFO - mozscreenshot == 0.1 17:10:05 INFO - mozsystemmonitor == 0.0 17:10:05 INFO - moztest == 0.7 17:10:05 INFO - mozversion == 1.4 17:10:05 INFO - psutil == 3.1.1 17:10:05 INFO - requests == 1.2.3 17:10:05 INFO - wsgiref == 0.1.2 17:10:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:10: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')]} 17:10:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:10:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:10: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')]} 17:10:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:10:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:10:05 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:10:05 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 17:10:05 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 17:10:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:10:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:10:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:10:05 INFO - 'HOME': '/Users/cltbld', 17:10:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:10:05 INFO - 'LOGNAME': 'cltbld', 17:10:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:10:05 INFO - 'MOZ_NO_REMOTE': '1', 17:10:05 INFO - 'NO_EM_RESTART': '1', 17:10:05 INFO - 'PAGER': '/bin/cat', 17:10:05 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:10:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:10:05 INFO - 'PWD': '/builds/slave/test', 17:10:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:10:05 INFO - 'SHELL': '/bin/bash', 17:10:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:10:05 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:10:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:10:05 INFO - 'USER': 'cltbld', 17:10:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:10:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:10:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:10:05 INFO - 'XPC_FLAGS': '0x0', 17:10:05 INFO - 'XPC_SERVICE_NAME': '0', 17:10:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:10:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 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)) 17:10:06 INFO - Cleaning up... 17:10:06 INFO - Return code: 0 17:10:06 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:10:06 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')]} 17:10:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:10:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:10:06 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')]} 17:10:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:10:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:10:06 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:10:06 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 17:10:06 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 17:10:06 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:10:06 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:10:06 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:10:06 INFO - 'HOME': '/Users/cltbld', 17:10:06 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:10:06 INFO - 'LOGNAME': 'cltbld', 17:10:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:10:06 INFO - 'MOZ_NO_REMOTE': '1', 17:10:06 INFO - 'NO_EM_RESTART': '1', 17:10:06 INFO - 'PAGER': '/bin/cat', 17:10:06 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:10:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:10:06 INFO - 'PWD': '/builds/slave/test', 17:10:06 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:10:06 INFO - 'SHELL': '/bin/bash', 17:10:06 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:10:06 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:10:06 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:10:06 INFO - 'USER': 'cltbld', 17:10:06 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:10:06 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:10:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:10:06 INFO - 'XPC_FLAGS': '0x0', 17:10:06 INFO - 'XPC_SERVICE_NAME': '0', 17:10:06 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:10:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:10:06 INFO - Downloading/unpacking jsonschema 17:10:06 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 17:10:06 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 17:10:06 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 17:10:06 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 17:10:06 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 17:10:06 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 17:10:08 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:10:08 INFO - Downloading/unpacking functools32 (from jsonschema) 17:10:08 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 17:10:08 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 17:10:08 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 17:10:08 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 17:10:08 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 17:10:08 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 17:10:09 INFO - Downloading functools32-3.2.3-2.tar.gz 17:10:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:10:09 INFO - warning: no files found matching '*.txt' 17:10:09 INFO - no previously-included directories found matching 'build' 17:10:09 INFO - no previously-included directories found matching 'dist' 17:10:09 INFO - no previously-included directories found matching '.git*' 17:10:09 INFO - Installing collected packages: jsonschema, functools32 17:10:09 INFO - Running setup.py install for functools32 17:10:09 INFO - warning: no files found matching '*.txt' 17:10:09 INFO - no previously-included directories found matching 'build' 17:10:09 INFO - no previously-included directories found matching 'dist' 17:10:09 INFO - no previously-included directories found matching '.git*' 17:10:09 INFO - Successfully installed jsonschema functools32 17:10:09 INFO - Cleaning up... 17:10:09 INFO - Return code: 0 17:10:09 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 17:10:09 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')]} 17:10:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:10:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:10:09 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')]} 17:10:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:10:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:10:09 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 0x10b5cda30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b5dd420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f98d1561100>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, '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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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 17:10:09 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 17:10:09 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 17:10:09 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:10:09 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:10:09 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:10:09 INFO - 'HOME': '/Users/cltbld', 17:10:09 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:10:09 INFO - 'LOGNAME': 'cltbld', 17:10:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:10:09 INFO - 'MOZ_NO_REMOTE': '1', 17:10:09 INFO - 'NO_EM_RESTART': '1', 17:10:09 INFO - 'PAGER': '/bin/cat', 17:10:09 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:10:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:10:09 INFO - 'PWD': '/builds/slave/test', 17:10:09 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:10:09 INFO - 'SHELL': '/bin/bash', 17:10:09 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:10:09 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:10:09 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:10:09 INFO - 'USER': 'cltbld', 17:10:09 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:10:09 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:10:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:10:09 INFO - 'XPC_FLAGS': '0x0', 17:10:09 INFO - 'XPC_SERVICE_NAME': '0', 17:10:09 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:10:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:10:09 INFO - Downloading/unpacking flake8 17:10:09 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 17:10:09 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 17:10:09 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 17:10:09 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 17:10:09 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 17:10:09 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 17:10:12 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 17:10:12 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 17:10: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 17:10: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 17:10: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 17:10: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 17:10: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 17:10: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 17:10:12 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 17:10:12 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 17:10: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 17:10: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 17:10: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 17:10: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 17:10: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 17:10: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 17:10:13 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 17:10:13 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 17:10:13 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 17:10:13 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 17:10:13 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 17:10:13 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 17:10:13 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 17:10:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 17:10:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:10:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:10:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:10:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:10:13 INFO - no previously-included directories found matching 'docs/_build' 17:10:13 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 17:10:13 INFO - Running setup.py install for pep8 17:10:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:10:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:10:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:10:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:10:13 INFO - no previously-included directories found matching 'docs/_build' 17:10:13 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 17:10:13 INFO - Successfully installed flake8 mccabe pyflakes pep8 17:10:13 INFO - Cleaning up... 17:10:13 INFO - Return code: 0 17:10:13 INFO - Running post-action listener: _resource_record_post_action 17:10:13 INFO - Running post-action listener: _start_resource_monitoring 17:10:13 INFO - Starting resource monitoring. 17:10:13 INFO - ##### 17:10:13 INFO - ##### Running install step. 17:10:13 INFO - ##### 17:10:13 INFO - Running pre-action listener: _resource_record_pre_action 17:10:13 INFO - Running main action method: install 17:10:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:10:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:10:14 INFO - Reading from file tmpfile_stdout 17:10:14 INFO - Detecting whether we're running mozinstall >=1.0... 17:10:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:10:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:10:14 INFO - Reading from file tmpfile_stdout 17:10:14 INFO - Output received: 17:10:14 INFO - Usage: mozinstall [options] installer 17:10:14 INFO - Options: 17:10:14 INFO - -h, --help show this help message and exit 17:10:14 INFO - -d DEST, --destination=DEST 17:10:14 INFO - Directory to install application into. [default: 17:10:14 INFO - "/builds/slave/test"] 17:10:14 INFO - --app=APP Application being installed. [default: firefox] 17:10:14 INFO - mkdir: /builds/slave/test/build/application 17:10:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 17:10:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 17:10:47 INFO - Reading from file tmpfile_stdout 17:10:47 INFO - Output received: 17:10:47 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 17:10:47 INFO - Running post-action listener: _resource_record_post_action 17:10:47 INFO - ##### 17:10:47 INFO - ##### Running run-tests step. 17:10:47 INFO - ##### 17:10:47 INFO - Running pre-action listener: _resource_record_pre_action 17:10:47 INFO - Running main action method: run_tests 17:10:47 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:10:47 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:10:47 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:10:47 INFO - 2016-04-06 17:10:47.962 screenresolution[1921:16011] starting screenresolution argv=screenresolution get 17:10:47 INFO - 2016-04-06 17:10:47.964 screenresolution[1921:16011] Display 0: 1600x1200x32@60 17:10:47 INFO - 2016-04-06 17:10:47.970 screenresolution[1922:16014] starting screenresolution argv=screenresolution list 17:10:47 INFO - Available Modes on Display 0 17:10:47 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:10:47 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:10:47 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:10:47 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:10:48 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:10:48 INFO - Intel Iris: 17:10:48 INFO - Chipset Model: Intel Iris 17:10:48 INFO - Type: GPU 17:10:48 INFO - Bus: Built-In 17:10:48 INFO - VRAM (Dynamic, Max): 1536 MB 17:10:48 INFO - Vendor: Intel (0x8086) 17:10:48 INFO - Device ID: 0x0a2e 17:10:48 INFO - Revision ID: 0x0009 17:10:48 INFO - Displays: 17:10:48 INFO - Display: 17:10:48 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:10:48 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:10:48 INFO - Display Serial Number: 1600x1200 60 17:10:48 INFO - Main Display: Yes 17:10:48 INFO - Mirror: Off 17:10:48 INFO - Online: Yes 17:10:48 INFO - Rotation: Supported 17:10:48 INFO - Return code: 0 17:10:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:10:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:10:48 INFO - Python 2.7.3 17:10:48 INFO - Return code: 0 17:10:48 INFO - grabbing minidump binary from tooltool 17:10:48 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')]} 17:10:48 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 0x10b46ce00>, '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 0x10b295db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b467b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:10:48 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 17:10:48 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 17:10:48 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:10:48 INFO - Return code: 0 17:10:48 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 17:10:48 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:10:48 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:10:48 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 17:10:48 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:10:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 17:10:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 17:10:49 INFO - Return code: 0 17:10:49 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/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0136', '--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 17:10:49 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/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0136 --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 17:10:49 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.A5fuX3nQH5/Render', 17:10:49 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:10:49 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:10:49 INFO - 'HOME': '/Users/cltbld', 17:10:49 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:10:49 INFO - 'LOGNAME': 'cltbld', 17:10:49 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:10:49 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 17:10:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:10:49 INFO - 'MOZ_NO_REMOTE': '1', 17:10:49 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:10:49 INFO - 'NO_EM_RESTART': '1', 17:10:49 INFO - 'PAGER': '/bin/cat', 17:10:49 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:10:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:10:49 INFO - 'PWD': '/builds/slave/test', 17:10:49 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:10:49 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:10:49 INFO - 'SHELL': '/bin/bash', 17:10:49 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bJVZZ6RPqm/Listeners', 17:10:49 INFO - 'TMPDIR': '/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/', 17:10:49 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:10:49 INFO - 'USER': 'cltbld', 17:10:49 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:10:49 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:10:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:10:49 INFO - 'XPC_FLAGS': '0x0', 17:10:49 INFO - 'XPC_SERVICE_NAME': '0', 17:10:49 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:10:49 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/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0136', '--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 17:10:49 INFO - mozversion application_buildid: 20160406160854 17:10:49 INFO - mozversion application_changeset: 133d8859d7b5e7d44d74c66aaa52c2da30cab3c4 17:10:49 INFO - mozversion application_display_name: Nightly 17:10:49 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:10:49 INFO - mozversion application_name: Firefox 17:10:49 INFO - mozversion application_remotingname: firefox 17:10:49 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 17:10:49 INFO - mozversion application_vendor: Mozilla 17:10:49 INFO - mozversion application_version: 48.0a1 17:10:49 INFO - mozversion platform_buildid: 20160406160854 17:10:49 INFO - mozversion platform_changeset: 133d8859d7b5e7d44d74c66aaa52c2da30cab3c4 17:10:49 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 17:10:49 INFO - mozversion platform_version: 48.0a1 17:10:49 INFO - using testdate: 1459987849 17:10:49 INFO - actual date: 1459987849 17:10:49 INFO - starting webserver on 'localhost:54559' 17:10:49 INFO - SUITE-START | Running 2 tests 17:10:49 INFO - TEST-START | dromaeo_css 17:10:49 INFO - operating with platform_type : mac_ 17:10:49 INFO - Initialising browser for dromaeo_css test... 17:10:49 INFO - TEST-INFO | started process 1940 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/tmpWqB8A0/profile http://localhost:54559/getInfo.html) 17:10:51 INFO - PROCESS | 1940 | __metrics Screen width/height:1600/1200 17:10:51 INFO - PROCESS | 1940 | colorDepth:24 17:10:51 INFO - PROCESS | 1940 | Browser inner width/height: 1024/689 17:10:51 INFO - PROCESS | 1940 | __metrics 17:10:51 INFO - PROCESS | 1940 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 17:10:51 ERROR - PROCESS | 1940 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 17:10:52 INFO - TEST-INFO | 1940: exit 0 17:10:52 INFO - Browser initialized. 17:10:52 INFO - Running cycle 1/1 for dromaeo_css test... 17:10:52 INFO - TEST-INFO | started process 1942 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/tmpWqB8A0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:11:04 INFO - PROCESS | 1942 | RSS: Main: 237043712 17:11:04 INFO - PROCESS | 1942 | 17:11:55 INFO - PROCESS | 1942 | 1459987915379 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] 17:14:05 INFO - PROCESS | 1942 | Cycle 1(1): loaded http://localhost:54559/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54559/tests/dromaeo/cssquery-ext.html) 17:14:07 INFO - PROCESS | 1942 | RSS: Main: 324943872 17:14:07 INFO - PROCESS | 1942 | 17:17:09 INFO - PROCESS | 1942 | Cycle 1(1): loaded http://localhost:54559/tests/dromaeo/cssquery-ext.html (next: http://localhost:54559/tests/dromaeo/cssquery-jquery.html) 17:17:10 INFO - PROCESS | 1942 | RSS: Main: 367288320 17:17:10 INFO - PROCESS | 1942 | 17:20:12 INFO - PROCESS | 1942 | Cycle 1(1): loaded http://localhost:54559/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54559/tests/dromaeo/cssquery-mootools.html) 17:20:12 INFO - PROCESS | 1942 | RSS: Main: 367935488 17:20:12 INFO - PROCESS | 1942 | 17:23:14 INFO - PROCESS | 1942 | Cycle 1(1): loaded http://localhost:54559/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54559/tests/dromaeo/cssquery-prototype.html) 17:23:15 INFO - PROCESS | 1942 | RSS: Main: 323121152 17:23:15 INFO - PROCESS | 1942 | 17:26:18 INFO - PROCESS | 1942 | Cycle 1(1): loaded http://localhost:54559/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54559/tests/dromaeo/cssquery-yui.html) 17:26:19 INFO - PROCESS | 1942 | RSS: Main: 326217728 17:26:19 INFO - PROCESS | 1942 | 17:29:21 INFO - PROCESS | 1942 | Cycle 1(1): loaded http://localhost:54559/tests/dromaeo/cssquery-yui.html (next: http://localhost:54559/tests/dromaeo/cssquery-dojo.html) 17:29:22 INFO - PROCESS | 1942 | RSS: Main: 371298304 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - PROCESS | 1942 | __start_tp_report 17:29:22 INFO - PROCESS | 1942 | _x_x_mozilla_page_load 17:29:22 INFO - PROCESS | 1942 | _x_x_mozilla_page_load_details 17:29:22 INFO - PROCESS | 1942 | |i|pagename|runs| 17:29:22 INFO - PROCESS | 1942 | |0;dojo.html;3037.3925214956985;3300.3234336960923;3386.441237195863;3478.3043391321735;3498.4402495600707;5518.613697041209;5612.989661860864;5627.77488900444;5659.490645841868;5675.432456754328;4303.54812744662;5674.375818659944;5765.827025189251;5777.017906955817;5790;5075.9746201268945;5084.211947148188;5112.130937740593;5130.692158470503;5276.314079169702;5160;5171.09505836479;5214.452482489341;5217.765200565984;5252.238425428311;5045.318881950963;5049.343585333883;5125.231215317732;5131.025105229995;5157.76790044447;5097.362829646294;5101.489851014906;5108.335916330853;5123.257127716498;5162.328897243372;5076.213186956028;5109.872253193663;5110.1356664377445;5137.33214682089;5145.614078944057;5438.8912221755345;5548.861278468071;5581.972090139564;5598.272224610774;5654.971725141348;6134.5092392608485;6134.9079763803575;6154;6156.7845125420845;6168.96915515424;6161.630302181883;6226.564140510166;6236.812895613093;6237.812865614039;6242.906356404657;5561.138023606348;5674.886502269931;5693.146028095736;5749.022666146765;5768.077107662838;6234.781782637586;6238.968805155945;6272.937270627326;6282.560220784592;6284.24589049317;6045.304789949124;6052.697365131726;6107.29766076898;6110.694465276807;6111.572189946661;6070.969645151746;6124.3809352984035;6139.492138333291;6203.937960620336;6216.129741836146;6106.976351602968;6113.144159817629;6137.386261373917;6155.322914479404;6173.536984726074;6148.6925653717135;6170.259568851767;6170.969145154246;6173.722182501798;6176.752929882844;4805.567498925114;4838.322634831126;4872.731999739977;4879.487653796371;4909.459959404463;4405.933910991338;4431.357453169337;4452;4453.087117140978;4454.977725111418;5456.972715136399;5525.254090697785;5527.585431092603;5532.75102620383;5533.363663178786;5821.505172060338;6107.12812945598;6162.198914141133;6241.407066328691;6266.122742816009;5514.6691198528215;5525.502704756511;5528.226048353234;5529.198266251451;5535.667859928417;5221.32122824038;5295.311609490818;5312.362516498045;5319.361676598755;5346.465353464622;6162.414570615784;6215.875682486416;6240.438360547572;6257.84355391128;6268.937310626835;6202.2867370253;6232.283287421823;6235.158253635701;6249.34381889895;6256;6175.938240617536;6183.288921773874;6254.312025677081;6254.718537665725;6268.435840774352;6082.178905847654;6130.153553065376;6140.478059365004;6145.6927153641245;6147.815565533041;6144.324124346229;6151.815445536641;6153.4154255345675;6159.907601386072;6178.41305076017;4966.652334336562;5900.321463031634;6009.429104235265;6058.454739073504;6108.02271636536;6027.21646185993;6057.878842423215;6067.575269731076;6072.757089716539;6087.66517841523;5876.500497457593;5899.852503687271;5920.082387229986;5925.111233315038;5939.940600593939;5828.76684932598;5925.259342582177;6042.244719410074;6066.514678825772;6106.938930610637;5856.267966504187;5858.384869588802;5864.912026319524;5868.882622347614;5886.882262354643 17:29:22 INFO - PROCESS | 1942 | |1;ext.html;487.87315298022503;573.9483446489816;574.8617736880973;628.4532456762618;631.9273283572389;38427.615723842755;38852;38876.41685374718;38912.61087389125;38948.610513894855;41667.37498937518;42214.57785422145;42224.577754222446;42233.57766422335;42288;7815.843683126334;9718.076782705632;9726.46504442259;9732.464714440703;9743.805123897519;9441.480718560477;9441.669541566047;9523.761905952337;9567.52162391881;9702.854457183148;9671.274654400913;9708.174805141536;9723.222142228604;9734.367266127714;9747.90252097477;9631.614735410576;9706.126448619587;9706.854397184048;9715.514224288758;9726.756831079245;9612.615495380247;9752.609895604168;9755.414675119515;9779.755506112333;9788.804223915482;41025.79487102546;41216.58783412157;41277;41330.79334603338;41447.96380090522;2788.735070168331;3167.493201087838;3182.9681703183137;3399.099238701746;3530.382183117944;28399.148025559265;28546.857265713537;28746.281342966384;28763.712362876522;28981.71018289811;2425.8840933170763;2713.8236014658983;2730.24918147509;2777.4861650594503;2798.272449163212;482294;486153;487566;487837;487882.1211787872;67378.32621673819;67727.32272677308;67742;67754;67794.66102669455;61650.691746541874;62649.68675156595;62863.371366286665;72806;73826.26173738301;16393.59016024609;16845.91577042107;16897.070661113758;16916.407925722542;16918.74621880673;12895.548655797002;12918.935405323102;13005.804912926315;13034.608961731163;13039.152455090389;18211.544711382056;21027.264045758326;21083.78916210849;21137;21163.25928592492;7710.961445192738;8327.37544684139;8494.108118647577;8526.658933642584;8570.571471426403;909.3997961345481;991.3011327014437;1035.6478797208986;1037.4812593703148;1054.9419781911915;28888.422231555673;29084.49190375495;29357.85321073381;30059.549106763418;30300.24249393783;1070.6680928912062;1083.2417307884355;1086.22877756792;1115.676453828397;1132.3375825142384;11629.825552616718;14624.707505849823;14870.330835112445;15028.248587570577;15326.616834579225;528651;533654;534584;535508;535593;58070;60090;60211;60231;60356;1443.444273954535;1448.391675496294;1470.3677418710058;1470.5955862137998;1473.7863009863725;23930.162444314366;26187;27582.448351032464;28088.157355279374;29737;55224;55426;55470.72264638651;55615;55634.72182639061;435740.8212958915;439101.2404441872;439934;440069;441152;31997.680023200403;33443;33463.16342091467;33464.49803253002;33492.99521014374;45147.41984030543;45432.54567454283;45579.54420455753;46022.079558409314;47039;37024;37153.25693486169;37173;37857.62142378651;38164.618353816106;36404.453933190496;37262;37472.625273748;37879.37111005618;38093;36511.81744091262;36933.261334772615;37137.44293835541;37222.06944826401;37807;30514.931977380686;31521.36957260796;31674;33510.497342540366;33651.3269734599;24175.65954726877;24540.6318905213;24591.554637364363;25001.499970000863;25138.99444022292 17:29:22 INFO - PROCESS | 1942 | |2;jquery.html;338.8881669049214;353.34454586741595;355.2699203137552;359.1667331790247;363.62546577025654;14659.926700366497;19838.603227935433;20101.396958091264;21525.784742152573;21567;11645.534178632866;11995.820062699044;12011.339376334297;12017.459214335355;20591.588168236627;5143.81996630118;5229.790808367679;5293.52358287754;5343.412224655304;5787.726700125987;3846.6345697158727;4033.3143365627766;4998.450170481244;5624.21261023457;5828.271466066742;5868.618539794921;5875.618084824473;5878.235829342179;5882.735276912549;5886.352501224862;5619.6066275360745;5895.115732640095;5902.704864756788;5913.408659134096;5921.141434491975;5615.466530679579;5641.351244606841;5647.689377084259;5648.209250704905;5652.491275785158;21240.5751884963;24955.50088998228;25278.356906801;25299.861506232264;25374.238772836845;2303.8502497337618;2630.2766739146696;2725.727427257278;2813.6482939632547;2897.6812550619416;7751.883721744179;9517.428954262698;9663.420194788336;9789.363691360039;10035.899641003643;1644.9965521032161;1651.6779228050534;1711.982880171195;1726.438907355102;1783.9018853963028;91157;105305.47347263292;108993;109002;110970.44514777375;10780.892191078146;11042.503087361089;11049.17131215162;11087.944560277308;11156;13760.380782864795;13814.240216788174;13816.723665526633;13822.239776812372;13838.823699985413;6049.334573196945;8314.41799074059;8419.115992820789;8453.873191902127;8483.575821208915;8437.409381343246;8485.618147183392;8493.447925884797;8578.01352844431;8607.18231767981;4267.0825772459075;4348.195583817004;4355.825766969286;4394.692371534026;4401.273789824707;1505.7515509940738;1525.5270866031344;1609.49300970194;1771.9911400443173;1782.1089455272363;950.5484894675112;959.3236768078488;960.1071003966379;993.8409854423257;999.5851721535481;19293.51766205828;19688.310909118398;19800.009999500257;20012.199512019357;20304.390868273975;874.5015341255423;922.9400088994194;958.3818437108026;983.0317137619439;993.4982833669095;9679.612815487442;10118.563752800472;10630.574777008987;10640.78718425627;10807;252887;626203;632467;640338;643254;119574;121904;122484.77515224734;124095;127127;995.1093771074992;1003.8042581696499;1038.3665963761948;1039.2725092435326;1041.094248004241;17315.653686926442;17560.034198118716;17671.29314827444;17752.2011509485;17806.643867122326;48188.27717584309;50882.49117508926;52093.41384412371;52172;54220.18669720036;71339.64330178316;71712.64143679457;74151;74383.62808185925;74521;7343.932686446335;7533.773986780406;7588.658510366937;7588.8482230356185;7938.174219929333;11192.272502287326;11923.76152476963;12145.332006739714;12381.62855114348;12476.126671132934;10188.694339169837;10365.429901355497;10474.842877356998;10622.937706229315;10707.625233116803;10403.531841067019;10423.583056677648;10482.580696772044;10668.146548276274;10792.895385399772;10439.217058720778;10878.292910960763;10919.39943303126;10987;11023.338599684044;7458.664360103699;7573.848523029398;7627.5042122261875;7808.453408261367;7854.60726963661;8820.514871681862;9140;10756.731081722706;11024.50389732448;11062.336259824437 17:29:22 INFO - PROCESS | 1942 | |3;mootools.html;1266.4301064520957;1566.0760151510608;1590.1174847959385;1869.7195420686896;2017.041905095079;8045;8730.3888727789;8914.687985920495;8916.108389161082;8928.017918029012;8591.097934716858;8814.515201663922;8821.51481668508;8824.382293239476;8833.984091829441;2183.2140429445385;2250.504888924434;2253.8422310438277;2445.669834572332;2493.989934076702;2442.291735396742;2511.535365957304;2512.5351809915132;2513.622956556522;2515.371157210697;2423.466837295792;2448.755124487555;2452.982012464834;2460.852348859074;2465.778079972802;2417.311066346083;2452.4181902672676;2454.791342735861;2461.5815311397105;2469.6293557075815;2438.0979037755965;2462.679851619278;2464.630305454178;2468.90124395024;2490.427201743591;8917.97443294023;8949.776255593597;8973.416727912665;8996.730098097001;9007.954960225223;5441.5102640762525;5587;5594.160875868612;5598.972005139989;5608.6073974821775;3564.483149943244;3607.314610224049;3675;3687.6865466435383;3693.556773187208;920.769807548113;1025.0876719719456;1039.7556574205055;1050.1965996013057;1063.393865496667;12034.759304813855;12054.698632534257;12064.698382540419;12073.758524829454;12075.818862717066;4157.667386609064;4857.587105096107;4888.120138375056;4894.070126675921;4982.975085124551;10215.591376345012;10217.74455638615;10231.079202871628;10231.641892533726;10237.48812559384;5535.418781028015;5544.972275138679;5551.611387202857;5552.7223638817895;5562.527185189304;4473.351364052194;4581.473130589959;4629.537046295343;5057.393112826484;5061.7975280989085;3398.844392906374;3652.7808331500196;3673.651003154696;3708.313961917054;3912.178442527101;1306.9673258168432;1311.4491913396396;1316.0918965913488;1325.9204447733166;1332.973340533184;1329.667583104224;1360.843502997148;1411.3507786418156;1411.7035422561378;1414.285785678226;8087.191280871866;8146.877796833052;8184.918150818416;8246.216609422096;8347.95826020866;1192.821076838481;1195.3664557784389;1196.85637723472;1207.673928039442;1221.3587866370049;6265.467435268053;6287.685615719196;6349.904751428732;6356.173697419306;6359.20509936258;10553.366797992145;10925.726856828484;11036.282641628268;11045.39250341239;11059.894010599037;10445.007724266183;10702.839457408145;10785.352878827296;10799.622013229498;10890;8300.543470109202;8337.66597344422;8473.49159050459;8477.23704866565;8489.61796719149;7992.720254791055;7997.92002079995;8073.434859559775;8299.377546683902;8299.917000829915;9136.223421009288;9396.013418591223;9442;9596.66411675588;9704.369216000938;8171.918280817115;9546.140847323773;9862.161716254199;9985.201183905416;9995.800083998425;7165;7463.813404664927;7503.474756766974;7594.240575942362;7606.315431611181;8292.543910084762;8319.875201872097;8377.916220837713;8379.371547133867;8395.538245396561;7320.341169294789;7347.816304592214;7441.441891858024;7467.58928258951;7563.810904727426;6303.212098487689;7219.963900180465;7283.235260297804;7390.002349682939;7438.888416673646;7596.544207347577;7860.3318717909615;7867.331276841533;7869.055713314439;7890.289873911146;7096.361327480551;7192.244814294424;7197.208307086321;7205.207427183111;7209.963950180216;7080.8937865933085;7246.927530724625;7260.818479538054;7263.34629883313;7266.1280646322775 17:29:22 INFO - PROCESS | 1942 | |4;prototype.html;318.26639595731837;320.31612507296916;326.90356344878256;330.86103836388713;333.0773756693958;5007.549320561149;6419.037144428332;6422.807315780528;6424.132742079818;6441.484681225503;6413.102165696806;6413.775517856876;6424.952280063553;6434.356564343575;6435.903461448082;4551.135284295973;4651.372064771246;4701.153792317382;4754.500777418373;4764.90470190596;4736.242201247801;4752.239641657336;4755.90488190236;4768.833090841821;4795.712257264558;4712.458067322267;4728.314394412808;4747.548982846624;4748.19280722278;4750.7149571025675;3463.82230041787;4504.324351347308;4544.363789069533;4745.430548334222;4746;4051.4327994080854;4058.6347228749555;4061.8984525386804;4071.2875246831686;4078.653314468274;6132.908006379907;6162.8767424651705;6171.228596425447;6198.2871969723155;6216.720247588869;5542.667439953616;5556;5561.5272701820395;5573.804916827932;5577.135543990688;6831.351021652935;6875.5530890491955;6882.827929301758;6890.31096890307;6894.103766510371;3820.4842346283453;4315.115401342718;4474.284114541658;4489.820407183742;4494.213512635309;7110.32451917067;7152.392046676039;7201.855962880713;7215.386692131123;7238.601876896769;4545.0000999779995;4551;4554.521775213621;4557.475890272594;4562.1560011398;3625.5286812714708;4268.932766808298;4593.26507758757;4616.930746038812;4617.053504031665;5464.371597266286;5467.289252397242;5473.28847249855;5479.369872464637;5479.808206712746;6595.472362211108;6909;6910.170779506491;6952.652367381611;6953.061336719579;1577.574055005165;1588.9046657200374;1602.118834640966;1604.9117298548692;1605.5343950254528;1007.8387458006683;1008.2287050406445;1025.2823023883311;1031.504877658728;1035.7980193862124;6002.609830361012;6138.171346868205;6198.783042593578;6291.905621415683;6295.5907865988565;5177.741112944413;5845.298564172326;7190.058684155353;7206.819829504304;7208.207097219301;5142.588592912558;6292.653904035322;6309.3690630936535;6318.273398559132;6318.589291696025;3740.495033170542;3777.9244415111543;3791.3933770596573;3795.1650636859845;3797.5063241778394;7159.021778805208;7313.341799237987;7390.408767298603;7409.703611855573;7425.108986921604;7309.378702810214;7347.228541003225;7354.852902942018;7361.374283185989;7368.521046131984;7346.559206447523;7371.778846634609;7383.446241531907;7385.483016188815;7389.482736208413;7132.928670713226;7146.464015198985;7152.392046675883;7162.928370716435;7164.2119366868565;6746.628935408599;7014.982827490087;7027.332403421667;7056.364927156581;7060.364567188978;7312.268773122645;7363.705451781869;7374.705011799682;7391.039164908742;7391.371733402721;4528.343390208467;4534.659900507541;4537.319402089581;4538.205813982606;4540.614047805841;7117.181524124792;7117.537360071578;7118.644067796693;7118.679659415235;7128.714851405885;6656.30108838565;6813;6869.450443964571;6895.75864844728;6908.412784913338;6836.897446538405;6840.965795170992;6866.210385805696;6870.20992585859;6874.759383421556;6723.361280678328;6729.327067293231;6730.596164230162;6744.865102698017;6763.560368576027;5606.719664016864;6863.421413074921;6872.656367181521;6875.48433867452;6878.965605171942;6458.903116453163;6483.189601299838;6628.337166283333;6727.293634168342;6729.360710732472 17:29:22 INFO - PROCESS | 1942 | |5;yui.html;662.9502787290953;670.741764420698;696.0290394899116;703.3564288675861;751.8609057324398;14504.782428263585;14792.260386980635;14873.776893346609;14876.553703388901;14916.105033697959;12406.255624662504;13420.463181472755;13504.18974861509;13526.256055916921;13575.660608484768;714.2857142857156;726;887.8579427291635;899.6896070855545;905.7509184974152;831.1771346367083;832.7543374704477;856.6787454704486;894.5035505294559;896.4666023715879;909.6315992023208;942.585262484508;943.7734943613517;945.6973768394116;945.9101385368378;751.3988808952815;928.7817362919675;936.8126374725014;937.0582564522679;938.1509733691021;697.0972590495321;701.5264696329957;702.6873041496536;702.761061239176;703.2299631903059;12532.81200781989;13586.592402227949;14498.637534061627;14561.708765824624;14655.70688586233;12405.317707526083;12410.131290809646;12445.315507647076;12522.186057906207;12812.551560695425;9707.854382184272;10099.899001010042;10271.075603195748;10329.586816527404;10444.947775261151;3516.7889926604485;3544.663256990582;3553.982230088859;3624.2207925295925;3706.2031663192543;75255.24744752537;75504;75533.62233188853;75631.62184189098;75727;9158.81682366349;9435.811283774286;9469;9724.805503890024;9786.853197202048;19999.99999999994;20696.48258793542;22198.223062192745;22234.55530889373;22234.88825558748;7427.442941779388;7622.885656715153;7707.691692332356;7772.883406748903;7779.416543759241;3988.760674359548;4114.876553703334;4139.875803725893;4151.97924010378;4154.626083652486;3473.992542162795;3582.5342705448124;3585.7489975701974;3588.102974256436;3593.4070878304788;653.9444147247442;656.3108735827362;661.3452681844939;662.9933700663028;664.1797380235405;584.5060923519619;590.3358721438382;593.4866340615337;594.6818452128091;633.297040285283;7897.644605992744;7980;8092.959535202286;8098.31164351025;8271.1728827118;474.99287510687367;570.9429057094341;590.147237242181;590.7164561010738;592.9377415371324;3751.6998640108727;3758.323501769653;3808.3716186828865;3901.43429202764;4007.879763607038;89093;91443;91625.54187229155;91879;92094;74493;75023.24976750162;75411;76293.6185319081;76309;64965;65183.34816651868;66176.66911665411;66357.66821165959;66965;7660.195679453577;7665.616719163908;7866.606669666379;7911.090224624242;8047.476914000571;38422.615773841906;39110.608893911834;44550;49637;51471.74264128655;64036.3596364049;64121.0381844282;65209.695806082666;65221.673891630235;65366;10745.086667633339;10861.34831910088;11067.833982490109;11081.445927703422;11170.944145279547;9530.890042112736;11842.348670823187;11871.406429678655;12357.93821030889;12742.365817076598;9729.70810875675;10525.9473702631;11207.271527350696;11430.028447581715;11452;11230.831537527107;11309.943450282695;11454.484548195518;11609.47757350938;11780.352080635646;11080.833787493355;11213.163799551234;11217;11645.301281923112;11728.237664551776;8203.272186415468;9204.861927070966;9409.341346105706;9415.905840941503;10020.94989525077;9345.766355841159;9614.567344469377;9625.202402586836;9745;9761.07269809367 17:29:22 INFO - PROCESS | 1942 | __end_tp_report 17:29:22 INFO - PROCESS | 1942 | __start_cc_report 17:29:22 INFO - PROCESS | 1942 | _x_x_mozilla_cycle_collect,1209 17:29:22 INFO - PROCESS | 1942 | __end_cc_report 17:29:22 INFO - PROCESS | 1942 | __startTimestamp1459988962195__endTimestamp 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - PROCESS | 1942 | ------- Summary: start ------- 17:29:22 INFO - PROCESS | 1942 | Number of tests: 6 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - PROCESS | 1942 | [#0] dojo.html Cycles:165 Average:5663.93 Median:5876.50 stddev:644.36 (11.0%) stddev-sans-first:612.51 17:29:22 INFO - PROCESS | 1942 | Values: 3037.4 3300.3 3386.4 3478.3 3498.4 5518.6 5613.0 5627.8 5659.5 5675.4 4303.5 5674.4 5765.8 5777.0 5790.0 5076.0 5084.2 5112.1 5130.7 5276.3 5160.0 5171.1 5214.5 5217.8 5252.2 5045.3 5049.3 5125.2 5131.0 5157.8 5097.4 5101.5 5108.3 5123.3 5162.3 5076.2 5109.9 5110.1 5137.3 5145.6 5438.9 5548.9 5582.0 5598.3 5655.0 6134.5 6134.9 6154.0 6156.8 6169.0 6161.6 6226.6 6236.8 6237.8 6242.9 5561.1 5674.9 5693.1 5749.0 5768.1 6234.8 6239.0 6272.9 6282.6 6284.2 6045.3 6052.7 6107.3 6110.7 6111.6 6071.0 6124.4 6139.5 6203.9 6216.1 6107.0 6113.1 6137.4 6155.3 6173.5 6148.7 6170.3 6171.0 6173.7 6176.8 4805.6 4838.3 4872.7 4879.5 4909.5 4405.9 4431.4 4452.0 4453.1 4455.0 5457.0 5525.3 5527.6 5532.8 5533.4 5821.5 6107.1 6162.2 6241.4 6266.1 5514.7 5525.5 5528.2 5529.2 5535.7 5221.3 5295.3 5312.4 5319.4 5346.5 6162.4 6215.9 6240.4 6257.8 6268.9 6202.3 6232.3 6235.2 6249.3 6256.0 6175.9 6183.3 6254.3 6254.7 6268.4 6082.2 6130.2 6140.5 6145.7 6147.8 6144.3 6151.8 6153.4 6159.9 6178.4 4966.7 5900.3 6009.4 6058.5 6108.0 6027.2 6057.9 6067.6 6072.8 6087.7 5876.5 5899.9 5920.1 5925.1 5939.9 5828.8 5925.3 6042.2 6066.5 6106.9 5856.3 5858.4 5864.9 5868.9 5886.9 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - PROCESS | 1942 | [#1] ext.html Cycles:180 Average:63757.46 Median:38894.51 stddev:129635.54 (333.3%) stddev-sans-first:129912.17 17:29:22 INFO - PROCESS | 1942 | Values: 487.9 573.9 574.9 628.5 631.9 38427.6 38852.0 38876.4 38912.6 38948.6 41667.4 42214.6 42224.6 42233.6 42288.0 7815.8 9718.1 9726.5 9732.5 9743.8 9441.5 9441.7 9523.8 9567.5 9702.9 9671.3 9708.2 9723.2 9734.4 9747.9 9631.6 9706.1 9706.9 9715.5 9726.8 9612.6 9752.6 9755.4 9779.8 9788.8 41025.8 41216.6 41277.0 41330.8 41448.0 2788.7 3167.5 3183.0 3399.1 3530.4 28399.1 28546.9 28746.3 28763.7 28981.7 2425.9 2713.8 2730.2 2777.5 2798.3 482294.0 486153.0 487566.0 487837.0 487882.1 67378.3 67727.3 67742.0 67754.0 67794.7 61650.7 62649.7 62863.4 72806.0 73826.3 16393.6 16845.9 16897.1 16916.4 16918.7 12895.5 12918.9 13005.8 13034.6 13039.2 18211.5 21027.3 21083.8 21137.0 21163.3 7711.0 8327.4 8494.1 8526.7 8570.6 909.4 991.3 1035.6 1037.5 1054.9 28888.4 29084.5 29357.9 30059.5 30300.2 1070.7 1083.2 1086.2 1115.7 1132.3 11629.8 14624.7 14870.3 15028.2 15326.6 528651.0 533654.0 534584.0 535508.0 535593.0 58070.0 60090.0 60211.0 60231.0 60356.0 1443.4 1448.4 1470.4 1470.6 1473.8 23930.2 26187.0 27582.4 28088.2 29737.0 55224.0 55426.0 55470.7 55615.0 55634.7 435740.8 439101.2 439934.0 440069.0 441152.0 31997.7 33443.0 33463.2 33464.5 33493.0 45147.4 45432.5 45579.5 46022.1 47039.0 37024.0 37153.3 37173.0 37857.6 38164.6 36404.5 37262.0 37472.6 37879.4 38093.0 36511.8 36933.3 37137.4 37222.1 37807.0 30514.9 31521.4 31674.0 33510.5 33651.3 24175.7 24540.6 24591.6 25001.5 25139.0 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - PROCESS | 1942 | [#2] jquery.html Cycles:180 Average:32737.72 Median:2855.66 stddev:96746.63 (3387.9%) stddev-sans-first:96987.44 17:29:22 INFO - PROCESS | 1942 | Values: 338.9 353.3 355.3 359.2 363.6 14659.9 19838.6 20101.4 21525.8 21567.0 11645.5 11995.8 12011.3 12017.5 20591.6 5143.8 5229.8 5293.5 5343.4 5787.7 3846.6 4033.3 4998.5 5624.2 5828.3 5868.6 5875.6 5878.2 5882.7 5886.4 5619.6 5895.1 5902.7 5913.4 5921.1 5615.5 5641.4 5647.7 5648.2 5652.5 21240.6 24955.5 25278.4 25299.9 25374.2 2303.9 2630.3 2725.7 2813.6 2897.7 7751.9 9517.4 9663.4 9789.4 10035.9 1645.0 1651.7 1712.0 1726.4 1783.9 91157.0 105305.5 108993.0 109002.0 110970.4 10780.9 11042.5 11049.2 11087.9 11156.0 13760.4 13814.2 13816.7 13822.2 13838.8 6049.3 8314.4 8419.1 8453.9 8483.6 8437.4 8485.6 8493.4 8578.0 8607.2 4267.1 4348.2 4355.8 4394.7 4401.3 1505.8 1525.5 1609.5 1772.0 1782.1 950.5 959.3 960.1 993.8 999.6 19293.5 19688.3 19800.0 20012.2 20304.4 874.5 922.9 958.4 983.0 993.5 9679.6 10118.6 10630.6 10640.8 10807.0 252887.0 626203.0 632467.0 640338.0 643254.0 119574.0 121904.0 122484.8 124095.0 127127.0 995.1 1003.8 1038.4 1039.3 1041.1 17315.7 17560.0 17671.3 17752.2 17806.6 48188.3 50882.5 52093.4 52172.0 54220.2 71339.6 71712.6 74151.0 74383.6 74521.0 7343.9 7533.8 7588.7 7588.8 7938.2 11192.3 11923.8 12145.3 12381.6 12476.1 10188.7 10365.4 10474.8 10622.9 10707.6 10403.5 10423.6 10482.6 10668.1 10792.9 10439.2 10878.3 10919.4 10987.0 11023.3 7458.7 7573.8 7627.5 7808.5 7854.6 8820.5 9140.0 10756.7 11024.5 11062.3 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - PROCESS | 1942 | [#3] mootools.html Cycles:180 Average:6104.26 Median:5540.20 stddev:3216.63 (58.1%) stddev-sans-first:3205.09 17:29:22 INFO - PROCESS | 1942 | Values: 1266.4 1566.1 1590.1 1869.7 2017.0 8045.0 8730.4 8914.7 8916.1 8928.0 8591.1 8814.5 8821.5 8824.4 8834.0 2183.2 2250.5 2253.8 2445.7 2494.0 2442.3 2511.5 2512.5 2513.6 2515.4 2423.5 2448.8 2453.0 2460.9 2465.8 2417.3 2452.4 2454.8 2461.6 2469.6 2438.1 2462.7 2464.6 2468.9 2490.4 8918.0 8949.8 8973.4 8996.7 9008.0 5441.5 5587.0 5594.2 5599.0 5608.6 3564.5 3607.3 3675.0 3687.7 3693.6 920.8 1025.1 1039.8 1050.2 1063.4 12034.8 12054.7 12064.7 12073.8 12075.8 4157.7 4857.6 4888.1 4894.1 4983.0 10215.6 10217.7 10231.1 10231.6 10237.5 5535.4 5545.0 5551.6 5552.7 5562.5 4473.4 4581.5 4629.5 5057.4 5061.8 3398.8 3652.8 3673.7 3708.3 3912.2 1307.0 1311.4 1316.1 1325.9 1333.0 1329.7 1360.8 1411.4 1411.7 1414.3 8087.2 8146.9 8184.9 8246.2 8348.0 1192.8 1195.4 1196.9 1207.7 1221.4 6265.5 6287.7 6349.9 6356.2 6359.2 10553.4 10925.7 11036.3 11045.4 11059.9 10445.0 10702.8 10785.4 10799.6 10890.0 8300.5 8337.7 8473.5 8477.2 8489.6 7992.7 7997.9 8073.4 8299.4 8299.9 9136.2 9396.0 9442.0 9596.7 9704.4 8171.9 9546.1 9862.2 9985.2 9995.8 7165.0 7463.8 7503.5 7594.2 7606.3 8292.5 8319.9 8377.9 8379.4 8395.5 7320.3 7347.8 7441.4 7467.6 7563.8 6303.2 7220.0 7283.2 7390.0 7438.9 7596.5 7860.3 7867.3 7869.1 7890.3 7096.4 7192.2 7197.2 7205.2 7210.0 7080.9 7246.9 7260.8 7263.3 7266.1 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - PROCESS | 1942 | [#4] prototype.html Cycles:180 Average:5581.87 Median:6302.48 stddev:1796.91 (28.5%) stddev-sans-first:1757.99 17:29:22 INFO - PROCESS | 1942 | Values: 318.3 320.3 326.9 330.9 333.1 5007.5 6419.0 6422.8 6424.1 6441.5 6413.1 6413.8 6425.0 6434.4 6435.9 4551.1 4651.4 4701.2 4754.5 4764.9 4736.2 4752.2 4755.9 4768.8 4795.7 4712.5 4728.3 4747.5 4748.2 4750.7 3463.8 4504.3 4544.4 4745.4 4746.0 4051.4 4058.6 4061.9 4071.3 4078.7 6132.9 6162.9 6171.2 6198.3 6216.7 5542.7 5556.0 5561.5 5573.8 5577.1 6831.4 6875.6 6882.8 6890.3 6894.1 3820.5 4315.1 4474.3 4489.8 4494.2 7110.3 7152.4 7201.9 7215.4 7238.6 4545.0 4551.0 4554.5 4557.5 4562.2 3625.5 4268.9 4593.3 4616.9 4617.1 5464.4 5467.3 5473.3 5479.4 5479.8 6595.5 6909.0 6910.2 6952.7 6953.1 1577.6 1588.9 1602.1 1604.9 1605.5 1007.8 1008.2 1025.3 1031.5 1035.8 6002.6 6138.2 6198.8 6291.9 6295.6 5177.7 5845.3 7190.1 7206.8 7208.2 5142.6 6292.7 6309.4 6318.3 6318.6 3740.5 3777.9 3791.4 3795.2 3797.5 7159.0 7313.3 7390.4 7409.7 7425.1 7309.4 7347.2 7354.9 7361.4 7368.5 7346.6 7371.8 7383.4 7385.5 7389.5 7132.9 7146.5 7152.4 7162.9 7164.2 6746.6 7015.0 7027.3 7056.4 7060.4 7312.3 7363.7 7374.7 7391.0 7391.4 4528.3 4534.7 4537.3 4538.2 4540.6 7117.2 7117.5 7118.6 7118.7 7128.7 6656.3 6813.0 6869.5 6895.8 6908.4 6836.9 6841.0 6866.2 6870.2 6874.8 6723.4 6729.3 6730.6 6744.9 6763.6 5606.7 6863.4 6872.7 6875.5 6879.0 6458.9 6483.2 6628.3 6727.3 6729.4 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - PROCESS | 1942 | [#5] yui.html Cycles:180 Average:17611.35 Median:65074.17 stddev:24562.52 (37.7%) stddev-sans-first:24598.46 17:29:22 INFO - PROCESS | 1942 | Values: 663.0 670.7 696.0 703.4 751.9 14504.8 14792.3 14873.8 14876.6 14916.1 12406.3 13420.5 13504.2 13526.3 13575.7 714.3 726.0 887.9 899.7 905.8 831.2 832.8 856.7 894.5 896.5 909.6 942.6 943.8 945.7 945.9 751.4 928.8 936.8 937.1 938.2 697.1 701.5 702.7 702.8 703.2 12532.8 13586.6 14498.6 14561.7 14655.7 12405.3 12410.1 12445.3 12522.2 12812.6 9707.9 10099.9 10271.1 10329.6 10444.9 3516.8 3544.7 3554.0 3624.2 3706.2 75255.2 75504.0 75533.6 75631.6 75727.0 9158.8 9435.8 9469.0 9724.8 9786.9 20000.0 20696.5 22198.2 22234.6 22234.9 7427.4 7622.9 7707.7 7772.9 7779.4 3988.8 4114.9 4139.9 4152.0 4154.6 3474.0 3582.5 3585.7 3588.1 3593.4 653.9 656.3 661.3 663.0 664.2 584.5 590.3 593.5 594.7 633.3 7897.6 7980.0 8093.0 8098.3 8271.2 475.0 570.9 590.1 590.7 592.9 3751.7 3758.3 3808.4 3901.4 4007.9 89093.0 91443.0 91625.5 91879.0 92094.0 74493.0 75023.2 75411.0 76293.6 76309.0 64965.0 65183.3 66176.7 66357.7 66965.0 7660.2 7665.6 7866.6 7911.1 8047.5 38422.6 39110.6 44550.0 49637.0 51471.7 64036.4 64121.0 65209.7 65221.7 65366.0 10745.1 10861.3 11067.8 11081.4 11170.9 9530.9 11842.3 11871.4 12357.9 12742.4 9729.7 10525.9 11207.3 11430.0 11452.0 11230.8 11309.9 11454.5 11609.5 11780.4 11080.8 11213.2 11217.0 11645.3 11728.2 8203.3 9204.9 9409.3 9415.9 10020.9 9345.8 9614.6 9625.2 9745.0 9761.1 17:29:22 INFO - PROCESS | 1942 | -------- Summary: end -------- 17:29:22 INFO - PROCESS | 1942 | 17:29:22 INFO - TEST-INFO | 1942: exit 0 17:29:22 INFO - TEST-OK | dromaeo_css | took 1113047ms 17:29:22 INFO - TEST-START | kraken 17:29:22 INFO - operating with platform_type : mac_ 17:29:22 INFO - Initialising browser for kraken test... 17:29:22 INFO - TEST-INFO | started process 1946 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/tmpqydBSB/profile http://localhost:54559/getInfo.html) 17:29:25 INFO - PROCESS | 1946 | __metrics Screen width/height:1600/1200 17:29:25 INFO - PROCESS | 1946 | colorDepth:24 17:29:25 INFO - PROCESS | 1946 | Browser inner width/height: 1024/689 17:29:25 INFO - PROCESS | 1946 | __metrics 17:29:25 INFO - PROCESS | 1946 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 17:29:25 ERROR - PROCESS | 1946 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 17:29:25 INFO - TEST-INFO | 1946: exit 0 17:29:25 INFO - Browser initialized. 17:29:25 INFO - Running cycle 1/1 for kraken test... 17:29:25 INFO - TEST-INFO | started process 1948 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/T/tmpqydBSB/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:29:37 INFO - PROCESS | 1948 | RSS: Main: 236929024 17:29:37 INFO - PROCESS | 1948 | 17:29:40 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54559/tests/kraken/driver.html?testName=audio-beat-detection) 17:29:41 INFO - PROCESS | 1948 | RSS: Main: 283037696 17:29:41 INFO - PROCESS | 1948 | 17:29:43 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54559/tests/kraken/driver.html?testName=audio-dft) 17:29:44 INFO - PROCESS | 1948 | RSS: Main: 293675008 17:29:44 INFO - PROCESS | 1948 | 17:29:47 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54559/tests/kraken/driver.html?testName=audio-fft) 17:29:48 INFO - PROCESS | 1948 | RSS: Main: 279650304 17:29:48 INFO - PROCESS | 1948 | 17:29:50 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54559/tests/kraken/driver.html?testName=audio-oscillator) 17:29:51 INFO - PROCESS | 1948 | RSS: Main: 282501120 17:29:51 INFO - PROCESS | 1948 | 17:29:53 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54559/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:29:53 INFO - PROCESS | 1948 | RSS: Main: 284049408 17:29:53 INFO - PROCESS | 1948 | 17:29:56 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54559/tests/kraken/driver.html?testName=imaging-darkroom) 17:29:57 INFO - PROCESS | 1948 | RSS: Main: 284299264 17:29:57 INFO - PROCESS | 1948 | 17:30:00 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54559/tests/kraken/driver.html?testName=imaging-desaturate) 17:30:00 INFO - PROCESS | 1948 | RSS: Main: 283934720 17:30:00 INFO - PROCESS | 1948 | 17:30:03 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54559/tests/kraken/driver.html?testName=json-parse-financial) 17:30:04 INFO - PROCESS | 1948 | RSS: Main: 284217344 17:30:04 INFO - PROCESS | 1948 | 17:30:05 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54559/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:30:06 INFO - PROCESS | 1948 | RSS: Main: 318828544 17:30:06 INFO - PROCESS | 1948 | 17:30:08 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54559/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:30:08 INFO - PROCESS | 1948 | RSS: Main: 319852544 17:30:08 INFO - PROCESS | 1948 | 17:30:10 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54559/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:30:11 INFO - PROCESS | 1948 | RSS: Main: 323710976 17:30:11 INFO - PROCESS | 1948 | 17:30:14 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54559/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:30:14 INFO - PROCESS | 1948 | RSS: Main: 324968448 17:30:14 INFO - PROCESS | 1948 | 17:30:17 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54559/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:30:17 INFO - PROCESS | 1948 | RSS: Main: 324968448 17:30:17 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | Cycle 1(1): loaded http://localhost:54559/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54559/tests/kraken/driver.html?testName=ai-astar) 17:30:19 INFO - PROCESS | 1948 | RSS: Main: 388214784 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | __start_tp_report 17:30:19 INFO - PROCESS | 1948 | _x_x_mozilla_page_load 17:30:19 INFO - PROCESS | 1948 | _x_x_mozilla_page_load_details 17:30:19 INFO - PROCESS | 1948 | |i|pagename|runs| 17:30:19 INFO - PROCESS | 1948 | |0;ai-astar;112;108;113;111;110;112;117;111;112;112 17:30:19 INFO - PROCESS | 1948 | |1;audio-beat-detection;178;155;175;168;107;166;168;143;172;121 17:30:19 INFO - PROCESS | 1948 | |2;audio-dft;186;186;186;184;184;188;185;184;184;182 17:30:19 INFO - PROCESS | 1948 | |3;audio-fft;75;77;85;80;56;59;56;81;88;77 17:30:19 INFO - PROCESS | 1948 | |4;audio-oscillator;93;91;131;77;78;82;119;80;76;119 17:30:19 INFO - PROCESS | 1948 | |5;imaging-gaussian-blur;89;85;90;87;88;85;90;87;90;87 17:30:19 INFO - PROCESS | 1948 | |6;imaging-darkroom;145;145;146;96;95;95;97;95;93;95 17:30:19 INFO - PROCESS | 1948 | |7;imaging-desaturate;84;84;88;85;86;85;87;86;85;85 17:30:19 INFO - PROCESS | 1948 | |8;json-parse-financial;54;54;55;53;47;52;80;91;77;58 17:30:19 INFO - PROCESS | 1948 | |9;json-stringify-tinderbox;67;71;70;80;73;73;68;69;70;69 17:30:19 INFO - PROCESS | 1948 | |10;stanford-crypto-aes;83;92;85;83;104;107;107;86;84;85 17:30:19 INFO - PROCESS | 1948 | |11;stanford-crypto-ccm;136;122;121;122;125;124;122;126;123;125 17:30:19 INFO - PROCESS | 1948 | |12;stanford-crypto-pbkdf2;143;131;139;138;139;132;140;136;138;139 17:30:19 INFO - PROCESS | 1948 | |13;stanford-crypto-sha256-iterative;57;92;94;92;94;90;68;68;66;67 17:30:19 INFO - PROCESS | 1948 | __end_tp_report 17:30:19 INFO - PROCESS | 1948 | __start_cc_report 17:30:19 INFO - PROCESS | 1948 | _x_x_mozilla_cycle_collect,1297 17:30:19 INFO - PROCESS | 1948 | __end_cc_report 17:30:19 INFO - PROCESS | 1948 | __startTimestamp1459989019853__endTimestamp 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | ------- Summary: start ------- 17:30:19 INFO - PROCESS | 1948 | Number of tests: 14 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#0] ai-astar Cycles:10 Average:111.80 Median:112.00 stddev:2.30 (2.1%) stddev-sans-first:2.44 17:30:19 INFO - PROCESS | 1948 | Values: 112.0 108.0 113.0 111.0 110.0 112.0 117.0 111.0 112.0 112.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#1] audio-beat-detection Cycles:10 Average:155.30 Median:168.00 stddev:24.22 (14.4%) stddev-sans-first:24.26 17:30:19 INFO - PROCESS | 1948 | Values: 178.0 155.0 175.0 168.0 107.0 166.0 168.0 143.0 172.0 121.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#2] audio-dft Cycles:10 Average:184.90 Median:185.50 stddev:1.66 (0.9%) stddev-sans-first:1.72 17:30:19 INFO - PROCESS | 1948 | Values: 186.0 186.0 186.0 184.0 184.0 188.0 185.0 184.0 184.0 182.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#3] audio-fft Cycles:10 Average:73.40 Median:78.50 stddev:11.97 (15.3%) stddev-sans-first:12.69 17:30:19 INFO - PROCESS | 1948 | Values: 75.0 77.0 85.0 80.0 56.0 59.0 56.0 81.0 88.0 77.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#4] audio-oscillator Cycles:10 Average:94.60 Median:79.00 stddev:20.64 (26.1%) stddev-sans-first:21.88 17:30:19 INFO - PROCESS | 1948 | Values: 93.0 91.0 131.0 77.0 78.0 82.0 119.0 80.0 76.0 119.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#5] imaging-gaussian-blur Cycles:10 Average:87.80 Median:88.50 stddev:1.93 (2.2%) stddev-sans-first:2.00 17:30:19 INFO - PROCESS | 1948 | Values: 89.0 85.0 90.0 87.0 88.0 85.0 90.0 87.0 90.0 87.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#6] imaging-darkroom Cycles:10 Average:110.20 Median:95.00 stddev:24.27 (25.5%) stddev-sans-first:22.23 17:30:19 INFO - PROCESS | 1948 | Values: 145.0 145.0 146.0 96.0 95.0 95.0 97.0 95.0 93.0 95.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#7] imaging-desaturate Cycles:10 Average:85.50 Median:85.50 stddev:1.27 (1.5%) stddev-sans-first:1.22 17:30:19 INFO - PROCESS | 1948 | Values: 84.0 84.0 88.0 85.0 86.0 85.0 87.0 86.0 85.0 85.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#8] json-parse-financial Cycles:10 Average:62.10 Median:56.50 stddev:14.87 (26.3%) stddev-sans-first:15.48 17:30:19 INFO - PROCESS | 1948 | Values: 54.0 54.0 55.0 53.0 47.0 52.0 80.0 91.0 77.0 58.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#9] json-stringify-tinderbox Cycles:10 Average:71.00 Median:70.50 stddev:3.71 (5.3%) stddev-sans-first:3.64 17:30:19 INFO - PROCESS | 1948 | Values: 67.0 71.0 70.0 80.0 73.0 73.0 68.0 69.0 70.0 69.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#10] stanford-crypto-aes Cycles:10 Average:91.60 Median:84.50 stddev:10.29 (12.2%) stddev-sans-first:10.43 17:30:19 INFO - PROCESS | 1948 | Values: 83.0 92.0 85.0 83.0 104.0 107.0 107.0 86.0 84.0 85.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#11] stanford-crypto-ccm Cycles:10 Average:124.60 Median:124.50 stddev:4.33 (3.5%) stddev-sans-first:1.73 17:30:19 INFO - PROCESS | 1948 | Values: 136.0 122.0 121.0 122.0 125.0 124.0 122.0 126.0 123.0 125.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:137.50 Median:139.00 stddev:3.63 (2.6%) stddev-sans-first:3.26 17:30:19 INFO - PROCESS | 1948 | Values: 143.0 131.0 139.0 138.0 139.0 132.0 140.0 136.0 138.0 139.0 17:30:19 INFO - PROCESS | 1948 | 17:30:19 INFO - PROCESS | 1948 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:78.80 Median:91.00 stddev:14.71 (16.2%) stddev-sans-first:13.32 17:30:19 INFO - PROCESS | 1948 | Values: 57.0 92.0 94.0 92.0 94.0 90.0 68.0 68.0 66.0 67.0 17:30:19 INFO - PROCESS | 1948 | -------- Summary: end -------- 17:30:19 INFO - PROCESS | 1948 | 17:30:20 INFO - TEST-INFO | 1948: exit 0 17:30:20 INFO - TEST-OK | kraken | took 57892ms 17:30:20 INFO - SUITE-END | took 1170s 17:30:21 INFO - Completed test suite (00:19:31) 17:30:21 INFO - javascript benchmark 17:30:21 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3037.3925214956985, 3300.3234336960923, 3386.441237195863, 3478.3043391321735, 3498.4402495600707, 5518.613697041209, 5612.989661860864, 5627.77488900444, 5659.490645841868, 5675.432456754328, 4303.54812744662, 5674.375818659944, 5765.827025189251, 5777.017906955817, 5790.0, 5075.9746201268945, 5084.211947148188, 5112.130937740593, 5130.692158470503, 5276.314079169702, 5160.0, 5171.09505836479, 5214.452482489341, 5217.765200565984, 5252.238425428311, 5045.318881950963, 5049.343585333883, 5125.231215317732, 5131.025105229995, 5157.76790044447, 5097.362829646294, 5101.489851014906, 5108.335916330853, 5123.257127716498, 5162.328897243372, 5076.213186956028, 5109.872253193663, 5110.1356664377445, 5137.33214682089, 5145.614078944057, 5438.8912221755345, 5548.861278468071, 5581.972090139564, 5598.272224610774, 5654.971725141348, 6134.5092392608485, 6134.9079763803575, 6154.0, 6156.7845125420845, 6168.96915515424, 6161.630302181883, 6226.564140510166, 6236.812895613093, 6237.812865614039, 6242.906356404657, 5561.138023606348, 5674.886502269931, 5693.146028095736, 5749.022666146765, 5768.077107662838, 6234.781782637586, 6238.968805155945, 6272.937270627326, 6282.560220784592, 6284.24589049317, 6045.304789949124, 6052.697365131726, 6107.29766076898, 6110.694465276807, 6111.572189946661, 6070.969645151746, 6124.3809352984035, 6139.492138333291, 6203.937960620336, 6216.129741836146, 6106.976351602968, 6113.144159817629, 6137.386261373917, 6155.322914479404, 6173.536984726074, 6148.6925653717135, 6170.259568851767, 6170.969145154246, 6173.722182501798, 6176.752929882844, 4805.567498925114, 4838.322634831126, 4872.731999739977, 4879.487653796371, 4909.459959404463, 4405.933910991338, 4431.357453169337, 4452.0, 4453.087117140978, 4454.977725111418, 5456.972715136399, 5525.254090697785, 5527.585431092603, 5532.75102620383, 5533.363663178786, 5821.505172060338, 6107.12812945598, 6162.198914141133, 6241.407066328691, 6266.122742816009, 5514.6691198528215, 5525.502704756511, 5528.226048353234, 5529.198266251451, 5535.667859928417, 5221.32122824038, 5295.311609490818, 5312.362516498045, 5319.361676598755, 5346.465353464622, 6162.414570615784, 6215.875682486416, 6240.438360547572, 6257.84355391128, 6268.937310626835, 6202.2867370253, 6232.283287421823, 6235.158253635701, 6249.34381889895, 6256.0, 6175.938240617536, 6183.288921773874, 6254.312025677081, 6254.718537665725, 6268.435840774352, 6082.178905847654, 6130.153553065376, 6140.478059365004, 6145.6927153641245, 6147.815565533041, 6144.324124346229, 6151.815445536641, 6153.4154255345675, 6159.907601386072, 6178.41305076017, 4966.652334336562, 5900.321463031634, 6009.429104235265, 6058.454739073504, 6108.02271636536, 6027.21646185993, 6057.878842423215, 6067.575269731076, 6072.757089716539, 6087.66517841523, 5876.500497457593, 5899.852503687271, 5920.082387229986, 5925.111233315038, 5939.940600593939, 5828.76684932598, 5925.259342582177, 6042.244719410074, 6066.514678825772, 6106.938930610637, 5856.267966504187, 5858.384869588802, 5864.912026319524, 5868.882622347614, 5886.882262354643], "unit": "score", "name": "dojo.html", "value": 5622.952635537582}, {"lowerIsBetter": false, "replicates": [487.87315298022503, 573.9483446489816, 574.8617736880973, 628.4532456762618, 631.9273283572389, 38427.615723842755, 38852.0, 38876.41685374718, 38912.61087389125, 38948.610513894855, 41667.37498937518, 42214.57785422145, 42224.577754222446, 42233.57766422335, 42288.0, 7815.843683126334, 9718.076782705632, 9726.46504442259, 9732.464714440703, 9743.805123897519, 9441.480718560477, 9441.669541566047, 9523.761905952337, 9567.52162391881, 9702.854457183148, 9671.274654400913, 9708.174805141536, 9723.222142228604, 9734.367266127714, 9747.90252097477, 9631.614735410576, 9706.126448619587, 9706.854397184048, 9715.514224288758, 9726.756831079245, 9612.615495380247, 9752.609895604168, 9755.414675119515, 9779.755506112333, 9788.804223915482, 41025.79487102546, 41216.58783412157, 41277.0, 41330.79334603338, 41447.96380090522, 2788.735070168331, 3167.493201087838, 3182.9681703183137, 3399.099238701746, 3530.382183117944, 28399.148025559265, 28546.857265713537, 28746.281342966384, 28763.712362876522, 28981.71018289811, 2425.8840933170763, 2713.8236014658983, 2730.24918147509, 2777.4861650594503, 2798.272449163212, 482294.0, 486153.0, 487566.0, 487837.0, 487882.1211787872, 67378.32621673819, 67727.32272677308, 67742.0, 67754.0, 67794.66102669455, 61650.691746541874, 62649.68675156595, 62863.371366286665, 72806.0, 73826.26173738301, 16393.59016024609, 16845.91577042107, 16897.070661113758, 16916.407925722542, 16918.74621880673, 12895.548655797002, 12918.935405323102, 13005.804912926315, 13034.608961731163, 13039.152455090389, 18211.544711382056, 21027.264045758326, 21083.78916210849, 21137.0, 21163.25928592492, 7710.961445192738, 8327.37544684139, 8494.108118647577, 8526.658933642584, 8570.571471426403, 909.3997961345481, 991.3011327014437, 1035.6478797208986, 1037.4812593703148, 1054.9419781911915, 28888.422231555673, 29084.49190375495, 29357.85321073381, 30059.549106763418, 30300.24249393783, 1070.6680928912062, 1083.2417307884355, 1086.22877756792, 1115.676453828397, 1132.3375825142384, 11629.825552616718, 14624.707505849823, 14870.330835112445, 15028.248587570577, 15326.616834579225, 528651.0, 533654.0, 534584.0, 535508.0, 535593.0, 58070.0, 60090.0, 60211.0, 60231.0, 60356.0, 1443.444273954535, 1448.391675496294, 1470.3677418710058, 1470.5955862137998, 1473.7863009863725, 23930.162444314366, 26187.0, 27582.448351032464, 28088.157355279374, 29737.0, 55224.0, 55426.0, 55470.72264638651, 55615.0, 55634.72182639061, 435740.8212958915, 439101.2404441872, 439934.0, 440069.0, 441152.0, 31997.680023200403, 33443.0, 33463.16342091467, 33464.49803253002, 33492.99521014374, 45147.41984030543, 45432.54567454283, 45579.54420455753, 46022.079558409314, 47039.0, 37024.0, 37153.25693486169, 37173.0, 37857.62142378651, 38164.618353816106, 36404.453933190496, 37262.0, 37472.625273748, 37879.37111005618, 38093.0, 36511.81744091262, 36933.261334772615, 37137.44293835541, 37222.06944826401, 37807.0, 30514.931977380686, 31521.36957260796, 31674.0, 33510.497342540366, 33651.3269734599, 24175.65954726877, 24540.6318905213, 24591.554637364363, 25001.499970000863, 25138.99444022292], "unit": "score", "name": "ext.html", "value": 19913.664490354633}, {"lowerIsBetter": false, "replicates": [338.8881669049214, 353.34454586741595, 355.2699203137552, 359.1667331790247, 363.62546577025654, 14659.926700366497, 19838.603227935433, 20101.396958091264, 21525.784742152573, 21567.0, 11645.534178632866, 11995.820062699044, 12011.339376334297, 12017.459214335355, 20591.588168236627, 5143.81996630118, 5229.790808367679, 5293.52358287754, 5343.412224655304, 5787.726700125987, 3846.6345697158727, 4033.3143365627766, 4998.450170481244, 5624.21261023457, 5828.271466066742, 5868.618539794921, 5875.618084824473, 5878.235829342179, 5882.735276912549, 5886.352501224862, 5619.6066275360745, 5895.115732640095, 5902.704864756788, 5913.408659134096, 5921.141434491975, 5615.466530679579, 5641.351244606841, 5647.689377084259, 5648.209250704905, 5652.491275785158, 21240.5751884963, 24955.50088998228, 25278.356906801, 25299.861506232264, 25374.238772836845, 2303.8502497337618, 2630.2766739146696, 2725.727427257278, 2813.6482939632547, 2897.6812550619416, 7751.883721744179, 9517.428954262698, 9663.420194788336, 9789.363691360039, 10035.899641003643, 1644.9965521032161, 1651.6779228050534, 1711.982880171195, 1726.438907355102, 1783.9018853963028, 91157.0, 105305.47347263292, 108993.0, 109002.0, 110970.44514777375, 10780.892191078146, 11042.503087361089, 11049.17131215162, 11087.944560277308, 11156.0, 13760.380782864795, 13814.240216788174, 13816.723665526633, 13822.239776812372, 13838.823699985413, 6049.334573196945, 8314.41799074059, 8419.115992820789, 8453.873191902127, 8483.575821208915, 8437.409381343246, 8485.618147183392, 8493.447925884797, 8578.01352844431, 8607.18231767981, 4267.0825772459075, 4348.195583817004, 4355.825766969286, 4394.692371534026, 4401.273789824707, 1505.7515509940738, 1525.5270866031344, 1609.49300970194, 1771.9911400443173, 1782.1089455272363, 950.5484894675112, 959.3236768078488, 960.1071003966379, 993.8409854423257, 999.5851721535481, 19293.51766205828, 19688.310909118398, 19800.009999500257, 20012.199512019357, 20304.390868273975, 874.5015341255423, 922.9400088994194, 958.3818437108026, 983.0317137619439, 993.4982833669095, 9679.612815487442, 10118.563752800472, 10630.574777008987, 10640.78718425627, 10807.0, 252887.0, 626203.0, 632467.0, 640338.0, 643254.0, 119574.0, 121904.0, 122484.77515224734, 124095.0, 127127.0, 995.1093771074992, 1003.8042581696499, 1038.3665963761948, 1039.2725092435326, 1041.094248004241, 17315.653686926442, 17560.034198118716, 17671.29314827444, 17752.2011509485, 17806.643867122326, 48188.27717584309, 50882.49117508926, 52093.41384412371, 52172.0, 54220.18669720036, 71339.64330178316, 71712.64143679457, 74151.0, 74383.62808185925, 74521.0, 7343.932686446335, 7533.773986780406, 7588.658510366937, 7588.8482230356185, 7938.174219929333, 11192.272502287326, 11923.76152476963, 12145.332006739714, 12381.62855114348, 12476.126671132934, 10188.694339169837, 10365.429901355497, 10474.842877356998, 10622.937706229315, 10707.625233116803, 10403.531841067019, 10423.583056677648, 10482.580696772044, 10668.146548276274, 10792.895385399772, 10439.217058720778, 10878.292910960763, 10919.39943303126, 10987.0, 11023.338599684044, 7458.664360103699, 7573.848523029398, 7627.5042122261875, 7808.453408261367, 7854.60726963661, 8820.514871681862, 9140.0, 10756.731081722706, 11024.50389732448, 11062.336259824437], "unit": "score", "name": "jquery.html", "value": 9065.3187597}, {"lowerIsBetter": false, "replicates": [1266.4301064520957, 1566.0760151510608, 1590.1174847959385, 1869.7195420686896, 2017.041905095079, 8045.0, 8730.3888727789, 8914.687985920495, 8916.108389161082, 8928.017918029012, 8591.097934716858, 8814.515201663922, 8821.51481668508, 8824.382293239476, 8833.984091829441, 2183.2140429445385, 2250.504888924434, 2253.8422310438277, 2445.669834572332, 2493.989934076702, 2442.291735396742, 2511.535365957304, 2512.5351809915132, 2513.622956556522, 2515.371157210697, 2423.466837295792, 2448.755124487555, 2452.982012464834, 2460.852348859074, 2465.778079972802, 2417.311066346083, 2452.4181902672676, 2454.791342735861, 2461.5815311397105, 2469.6293557075815, 2438.0979037755965, 2462.679851619278, 2464.630305454178, 2468.90124395024, 2490.427201743591, 8917.97443294023, 8949.776255593597, 8973.416727912665, 8996.730098097001, 9007.954960225223, 5441.5102640762525, 5587.0, 5594.160875868612, 5598.972005139989, 5608.6073974821775, 3564.483149943244, 3607.314610224049, 3675.0, 3687.6865466435383, 3693.556773187208, 920.769807548113, 1025.0876719719456, 1039.7556574205055, 1050.1965996013057, 1063.393865496667, 12034.759304813855, 12054.698632534257, 12064.698382540419, 12073.758524829454, 12075.818862717066, 4157.667386609064, 4857.587105096107, 4888.120138375056, 4894.070126675921, 4982.975085124551, 10215.591376345012, 10217.74455638615, 10231.079202871628, 10231.641892533726, 10237.48812559384, 5535.418781028015, 5544.972275138679, 5551.611387202857, 5552.7223638817895, 5562.527185189304, 4473.351364052194, 4581.473130589959, 4629.537046295343, 5057.393112826484, 5061.7975280989085, 3398.844392906374, 3652.7808331500196, 3673.651003154696, 3708.313961917054, 3912.178442527101, 1306.9673258168432, 1311.4491913396396, 1316.0918965913488, 1325.9204447733166, 1332.973340533184, 1329.667583104224, 1360.843502997148, 1411.3507786418156, 1411.7035422561378, 1414.285785678226, 8087.191280871866, 8146.877796833052, 8184.918150818416, 8246.216609422096, 8347.95826020866, 1192.821076838481, 1195.3664557784389, 1196.85637723472, 1207.673928039442, 1221.3587866370049, 6265.467435268053, 6287.685615719196, 6349.904751428732, 6356.173697419306, 6359.20509936258, 10553.366797992145, 10925.726856828484, 11036.282641628268, 11045.39250341239, 11059.894010599037, 10445.007724266183, 10702.839457408145, 10785.352878827296, 10799.622013229498, 10890.0, 8300.543470109202, 8337.66597344422, 8473.49159050459, 8477.23704866565, 8489.61796719149, 7992.720254791055, 7997.92002079995, 8073.434859559775, 8299.377546683902, 8299.917000829915, 9136.223421009288, 9396.013418591223, 9442.0, 9596.66411675588, 9704.369216000938, 8171.918280817115, 9546.140847323773, 9862.161716254199, 9985.201183905416, 9995.800083998425, 7165.0, 7463.813404664927, 7503.474756766974, 7594.240575942362, 7606.315431611181, 8292.543910084762, 8319.875201872097, 8377.916220837713, 8379.371547133867, 8395.538245396561, 7320.341169294789, 7347.816304592214, 7441.441891858024, 7467.58928258951, 7563.810904727426, 6303.212098487689, 7219.963900180465, 7283.235260297804, 7390.002349682939, 7438.888416673646, 7596.544207347577, 7860.3318717909615, 7867.331276841533, 7869.055713314439, 7890.289873911146, 7096.361327480551, 7192.244814294424, 7197.208307086321, 7205.207427183111, 7209.963950180216, 7080.8937865933085, 7246.927530724625, 7260.818479538054, 7263.34629883313, 7266.1280646322775], "unit": "score", "name": "mootools.html", "value": 4981.385594945567}, {"lowerIsBetter": false, "replicates": [318.26639595731837, 320.31612507296916, 326.90356344878256, 330.86103836388713, 333.0773756693958, 5007.549320561149, 6419.037144428332, 6422.807315780528, 6424.132742079818, 6441.484681225503, 6413.102165696806, 6413.775517856876, 6424.952280063553, 6434.356564343575, 6435.903461448082, 4551.135284295973, 4651.372064771246, 4701.153792317382, 4754.500777418373, 4764.90470190596, 4736.242201247801, 4752.239641657336, 4755.90488190236, 4768.833090841821, 4795.712257264558, 4712.458067322267, 4728.314394412808, 4747.548982846624, 4748.19280722278, 4750.7149571025675, 3463.82230041787, 4504.324351347308, 4544.363789069533, 4745.430548334222, 4746.0, 4051.4327994080854, 4058.6347228749555, 4061.8984525386804, 4071.2875246831686, 4078.653314468274, 6132.908006379907, 6162.8767424651705, 6171.228596425447, 6198.2871969723155, 6216.720247588869, 5542.667439953616, 5556.0, 5561.5272701820395, 5573.804916827932, 5577.135543990688, 6831.351021652935, 6875.5530890491955, 6882.827929301758, 6890.31096890307, 6894.103766510371, 3820.4842346283453, 4315.115401342718, 4474.284114541658, 4489.820407183742, 4494.213512635309, 7110.32451917067, 7152.392046676039, 7201.855962880713, 7215.386692131123, 7238.601876896769, 4545.0000999779995, 4551.0, 4554.521775213621, 4557.475890272594, 4562.1560011398, 3625.5286812714708, 4268.932766808298, 4593.26507758757, 4616.930746038812, 4617.053504031665, 5464.371597266286, 5467.289252397242, 5473.28847249855, 5479.369872464637, 5479.808206712746, 6595.472362211108, 6909.0, 6910.170779506491, 6952.652367381611, 6953.061336719579, 1577.574055005165, 1588.9046657200374, 1602.118834640966, 1604.9117298548692, 1605.5343950254528, 1007.8387458006683, 1008.2287050406445, 1025.2823023883311, 1031.504877658728, 1035.7980193862124, 6002.609830361012, 6138.171346868205, 6198.783042593578, 6291.905621415683, 6295.5907865988565, 5177.741112944413, 5845.298564172326, 7190.058684155353, 7206.819829504304, 7208.207097219301, 5142.588592912558, 6292.653904035322, 6309.3690630936535, 6318.273398559132, 6318.589291696025, 3740.495033170542, 3777.9244415111543, 3791.3933770596573, 3795.1650636859845, 3797.5063241778394, 7159.021778805208, 7313.341799237987, 7390.408767298603, 7409.703611855573, 7425.108986921604, 7309.378702810214, 7347.228541003225, 7354.852902942018, 7361.374283185989, 7368.521046131984, 7346.559206447523, 7371.778846634609, 7383.446241531907, 7385.483016188815, 7389.482736208413, 7132.928670713226, 7146.464015198985, 7152.392046675883, 7162.928370716435, 7164.2119366868565, 6746.628935408599, 7014.982827490087, 7027.332403421667, 7056.364927156581, 7060.364567188978, 7312.268773122645, 7363.705451781869, 7374.705011799682, 7391.039164908742, 7391.371733402721, 4528.343390208467, 4534.659900507541, 4537.319402089581, 4538.205813982606, 4540.614047805841, 7117.181524124792, 7117.537360071578, 7118.644067796693, 7118.679659415235, 7128.714851405885, 6656.30108838565, 6813.0, 6869.450443964571, 6895.75864844728, 6908.412784913338, 6836.897446538405, 6840.965795170992, 6866.210385805696, 6870.20992585859, 6874.759383421556, 6723.361280678328, 6729.327067293231, 6730.596164230162, 6744.865102698017, 6763.560368576027, 5606.719664016864, 6863.421413074921, 6872.656367181521, 6875.48433867452, 6878.965605171942, 6458.903116453163, 6483.189601299838, 6628.337166283333, 6727.293634168342, 6729.360710732472], "unit": "score", "name": "prototype.html", "value": 4985.311044386906}, {"lowerIsBetter": false, "replicates": [662.9502787290953, 670.741764420698, 696.0290394899116, 703.3564288675861, 751.8609057324398, 14504.782428263585, 14792.260386980635, 14873.776893346609, 14876.553703388901, 14916.105033697959, 12406.255624662504, 13420.463181472755, 13504.18974861509, 13526.256055916921, 13575.660608484768, 714.2857142857156, 726.0, 887.8579427291635, 899.6896070855545, 905.7509184974152, 831.1771346367083, 832.7543374704477, 856.6787454704486, 894.5035505294559, 896.4666023715879, 909.6315992023208, 942.585262484508, 943.7734943613517, 945.6973768394116, 945.9101385368378, 751.3988808952815, 928.7817362919675, 936.8126374725014, 937.0582564522679, 938.1509733691021, 697.0972590495321, 701.5264696329957, 702.6873041496536, 702.761061239176, 703.2299631903059, 12532.81200781989, 13586.592402227949, 14498.637534061627, 14561.708765824624, 14655.70688586233, 12405.317707526083, 12410.131290809646, 12445.315507647076, 12522.186057906207, 12812.551560695425, 9707.854382184272, 10099.899001010042, 10271.075603195748, 10329.586816527404, 10444.947775261151, 3516.7889926604485, 3544.663256990582, 3553.982230088859, 3624.2207925295925, 3706.2031663192543, 75255.24744752537, 75504.0, 75533.62233188853, 75631.62184189098, 75727.0, 9158.81682366349, 9435.811283774286, 9469.0, 9724.805503890024, 9786.853197202048, 19999.99999999994, 20696.48258793542, 22198.223062192745, 22234.55530889373, 22234.88825558748, 7427.442941779388, 7622.885656715153, 7707.691692332356, 7772.883406748903, 7779.416543759241, 3988.760674359548, 4114.876553703334, 4139.875803725893, 4151.97924010378, 4154.626083652486, 3473.992542162795, 3582.5342705448124, 3585.7489975701974, 3588.102974256436, 3593.4070878304788, 653.9444147247442, 656.3108735827362, 661.3452681844939, 662.9933700663028, 664.1797380235405, 584.5060923519619, 590.3358721438382, 593.4866340615337, 594.6818452128091, 633.297040285283, 7897.644605992744, 7980.0, 8092.959535202286, 8098.31164351025, 8271.1728827118, 474.99287510687367, 570.9429057094341, 590.147237242181, 590.7164561010738, 592.9377415371324, 3751.6998640108727, 3758.323501769653, 3808.3716186828865, 3901.43429202764, 4007.879763607038, 89093.0, 91443.0, 91625.54187229155, 91879.0, 92094.0, 74493.0, 75023.24976750162, 75411.0, 76293.6185319081, 76309.0, 64965.0, 65183.34816651868, 66176.66911665411, 66357.66821165959, 66965.0, 7660.195679453577, 7665.616719163908, 7866.606669666379, 7911.090224624242, 8047.476914000571, 38422.615773841906, 39110.608893911834, 44550.0, 49637.0, 51471.74264128655, 64036.3596364049, 64121.0381844282, 65209.695806082666, 65221.673891630235, 65366.0, 10745.086667633339, 10861.34831910088, 11067.833982490109, 11081.445927703422, 11170.944145279547, 9530.890042112736, 11842.348670823187, 11871.406429678655, 12357.93821030889, 12742.365817076598, 9729.70810875675, 10525.9473702631, 11207.271527350696, 11430.028447581715, 11452.0, 11230.831537527107, 11309.943450282695, 11454.484548195518, 11609.47757350938, 11780.352080635646, 11080.833787493355, 11213.163799551234, 11217.0, 11645.301281923112, 11728.237664551776, 8203.272186415468, 9204.861927070966, 9409.341346105706, 9415.905840941503, 10020.94989525077, 9345.766355841159, 9614.567344469377, 9625.202402586836, 9745.0, 9761.07269809367], "unit": "score", "name": "yui.html", "value": 6756.6796467446065}], "name": "dromaeo_css", "value": 7445.347888870509}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 108.0, 113.0, 111.0, 110.0, 112.0, 117.0, 111.0, 112.0, 112.0], "unit": "score", "name": "ai-astar", "value": 111.8}, {"lowerIsBetter": true, "replicates": [178.0, 155.0, 175.0, 168.0, 107.0, 166.0, 168.0, 143.0, 172.0, 121.0], "unit": "score", "name": "audio-beat-detection", "value": 155.3}, {"lowerIsBetter": true, "replicates": [186.0, 186.0, 186.0, 184.0, 184.0, 188.0, 185.0, 184.0, 184.0, 182.0], "unit": "score", "name": "audio-dft", "value": 184.9}, {"lowerIsBetter": true, "replicates": [75.0, 77.0, 85.0, 80.0, 56.0, 59.0, 56.0, 81.0, 88.0, 77.0], "unit": "score", "name": "audio-fft", "value": 73.4}, {"lowerIsBetter": true, "replicates": [93.0, 91.0, 131.0, 77.0, 78.0, 82.0, 119.0, 80.0, 76.0, 119.0], "unit": "score", "name": "audio-oscillator", "value": 94.6}, {"lowerIsBetter": true, "replicates": [89.0, 85.0, 90.0, 87.0, 88.0, 85.0, 90.0, 87.0, 90.0, 87.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 87.8}, {"lowerIsBetter": true, "replicates": [145.0, 145.0, 146.0, 96.0, 95.0, 95.0, 97.0, 95.0, 93.0, 95.0], "unit": "score", "name": "imaging-darkroom", "value": 110.2}, {"lowerIsBetter": true, "replicates": [84.0, 84.0, 88.0, 85.0, 86.0, 85.0, 87.0, 86.0, 85.0, 85.0], "unit": "score", "name": "imaging-desaturate", "value": 85.5}, {"lowerIsBetter": true, "replicates": [54.0, 54.0, 55.0, 53.0, 47.0, 52.0, 80.0, 91.0, 77.0, 58.0], "unit": "score", "name": "json-parse-financial", "value": 62.1}, {"lowerIsBetter": true, "replicates": [67.0, 71.0, 70.0, 80.0, 73.0, 73.0, 68.0, 69.0, 70.0, 69.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 71.0}, {"lowerIsBetter": true, "replicates": [83.0, 92.0, 85.0, 83.0, 104.0, 107.0, 107.0, 86.0, 84.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 91.6}, {"lowerIsBetter": true, "replicates": [136.0, 122.0, 121.0, 122.0, 125.0, 124.0, 122.0, 126.0, 123.0, 125.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 124.6}, {"lowerIsBetter": true, "replicates": [143.0, 131.0, 139.0, 138.0, 139.0, 132.0, 140.0, 136.0, 138.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 137.5}, {"lowerIsBetter": true, "replicates": [57.0, 92.0, 94.0, 92.0, 94.0, 90.0, 68.0, 68.0, 66.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 78.8}], "name": "kraken", "value": 1469.0999999999997}]} 17:30:21 INFO - Return code: 0 17:30:21 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 17:30:21 ERROR - # TBPL SUCCESS # 17:30:21 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:30:21 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:30:21 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:30:21 INFO - 2016-04-06 17:30:21.192 screenresolution[1953:17880] starting screenresolution argv=screenresolution get 17:30:21 INFO - 2016-04-06 17:30:21.195 screenresolution[1953:17880] Display 0: 1600x1200x32@60 17:30:21 INFO - 2016-04-06 17:30:21.201 screenresolution[1954:17883] starting screenresolution argv=screenresolution list 17:30:21 INFO - Available Modes on Display 0 17:30:21 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:30:21 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:30:21 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:30:21 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:30:21 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:30:21 INFO - Intel Iris: 17:30:21 INFO - Chipset Model: Intel Iris 17:30:21 INFO - Type: GPU 17:30:21 INFO - Bus: Built-In 17:30:21 INFO - VRAM (Dynamic, Max): 1536 MB 17:30:21 INFO - Vendor: Intel (0x8086) 17:30:21 INFO - Device ID: 0x0a2e 17:30:21 INFO - Revision ID: 0x0009 17:30:21 INFO - Displays: 17:30:21 INFO - Display: 17:30:21 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:30:21 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:30:21 INFO - Display Serial Number: 1600x1200 60 17:30:21 INFO - Main Display: Yes 17:30:21 INFO - Mirror: Off 17:30:21 INFO - Online: Yes 17:30:21 INFO - Rotation: Supported 17:30:21 INFO - Return code: 0 17:30:21 INFO - Running post-action listener: _resource_record_post_action 17:30:21 INFO - Running post-run listener: _resource_record_post_run 17:30:22 INFO - Total resource usage - Wall time: 1207s; CPU: 53.0%; Read bytes: 425984; Write bytes: 692067328; Read time: 18; Write time: 1927 17:30:22 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 392903168; Write bytes: 394798592; Read time: 29959; Write time: 767 17:30:22 INFO - run-tests - Wall time: 1173s; CPU: 53.0%; Read bytes: 425984; Write bytes: 296420864; Read time: 18; Write time: 1157 17:30:22 INFO - Running post-run listener: _upload_blobber_files 17:30:22 INFO - Blob upload gear active. 17:30:22 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:30:22 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 17:30:22 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'] 17:30:22 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 17:30:22 INFO - (blobuploader) - INFO - Open directory for files ... 17:30:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 17:30:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:30:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:30:24 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 17:30:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:30:24 INFO - (blobuploader) - INFO - Done attempting. 17:30:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 17:30:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:30:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:30:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 17:30:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:30:25 INFO - (blobuploader) - INFO - Done attempting. 17:30:25 INFO - (blobuploader) - INFO - Iteration through files over. 17:30:25 INFO - Return code: 0 17:30:25 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:30:25 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:30:25 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/16c9e33f737a21117da93cc1fbd6cd3f7877106cd1e732dde92206ef474fc62b9be6f22db5737aaca83f528745f63a14f352003433b7dbe2285de1f83d2afa41", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/051ecc7d57ef1b971d2d61eff01ddc57b4532158af28ddaa0a53f8ee14f68fa5039460ae337a2404b34747f946879a005b2a52952a7ce28fe4e53f593d651eff"} 17:30:25 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:30:25 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:30:25 INFO - Contents: 17:30:25 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/16c9e33f737a21117da93cc1fbd6cd3f7877106cd1e732dde92206ef474fc62b9be6f22db5737aaca83f528745f63a14f352003433b7dbe2285de1f83d2afa41", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/051ecc7d57ef1b971d2d61eff01ddc57b4532158af28ddaa0a53f8ee14f68fa5039460ae337a2404b34747f946879a005b2a52952a7ce28fe4e53f593d651eff"} 17:30:25 INFO - Running post-run listener: copy_logs_to_upload_dir 17:30:25 INFO - Copying logs to upload dir... 17:30:25 INFO - mkdir: /builds/slave/test/build/upload/logs 17:30:25 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1303.520597 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 43 secs) (at 2016-04-06 17:30:25.292759) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-06 17:30:25.296284) ========= 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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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/16c9e33f737a21117da93cc1fbd6cd3f7877106cd1e732dde92206ef474fc62b9be6f22db5737aaca83f528745f63a14f352003433b7dbe2285de1f83d2afa41", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/051ecc7d57ef1b971d2d61eff01ddc57b4532158af28ddaa0a53f8ee14f68fa5039460ae337a2404b34747f946879a005b2a52952a7ce28fe4e53f593d651eff"} build_url:https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011366 build_url: 'https://queue.taskcluster.net/v1/task/cLaipezESH2_7LtzVhNFKQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/16c9e33f737a21117da93cc1fbd6cd3f7877106cd1e732dde92206ef474fc62b9be6f22db5737aaca83f528745f63a14f352003433b7dbe2285de1f83d2afa41", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/051ecc7d57ef1b971d2d61eff01ddc57b4532158af28ddaa0a53f8ee14f68fa5039460ae337a2404b34747f946879a005b2a52952a7ce28fe4e53f593d651eff"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-06 17:30:25.323490) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:30:25.323805) ========= 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.A5fuX3nQH5/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.bJVZZ6RPqm/Listeners TMPDIR=/var/folders/xw/1xk600bn7yzb_vgtx1q14h5000000w/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.005275 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-06 17:30:25.372771) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-06 17:30:25.373096) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-06 17:30:25.373481) ========= ========= Total master_lag: 0.29 =========