builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0108 starttime: 1457460525.85 results: success (0) buildid: 20160308090122 builduid: 2af825ddece64556a242b57551c745f2 revision: 9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:45.845813) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:45.846166) ========= ========= Started set props: basedir (results: 0, elapsed: 5 secs) (at 2016-03-08 10:08:45.846441) ========= 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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/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.005769 basedir: '/builds/slave/test' ========= master_lag: 5.25 ========= ========= Finished set props: basedir (results: 0, elapsed: 5 secs) (at 2016-03-08 10:08:51.101271) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-03-08 10:08:51.101602) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-03-08 10:08:53.100783) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:53.101031) ========= 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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/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.006066 ========= master_lag: 0.64 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:53.742998) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:53.743292) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:53.743656) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-08 10:08:53.743926) ========= 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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/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-03-08 10:08:53-- 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% 163M=0s 2016-03-08 10:08:54 (163 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.474293 ========= master_lag: 0.89 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-08 10:08:55.112227) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:55.112502) ========= 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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/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.027178 ========= master_lag: 0.61 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:55.753585) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-03-08 10:08:55.753898) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d --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 9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/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-03-08 10:08:56,044 truncating revision to first 12 chars 2016-03-08 10:08:56,044 Setting DEBUG logging. 2016-03-08 10:08:56,044 attempt 1/10 2016-03-08 10:08:56,044 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/9b6dc52f6012?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-08 10:08:57,168 unpacking tar archive at: fx-team-9b6dc52f6012/testing/mozharness/ program finished with exit code 0 elapsedTime=1.369640 ========= master_lag: 0.78 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-03-08 10:08:57.906895) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:57.910817) ========= echo 9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/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 9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d program finished with exit code 0 elapsedTime=0.006211 script_repo_revision: '9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d' ========= master_lag: 0.11 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-08 10:08:58.028724) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 6 secs) (at 2016-03-08 10:08:58.029007) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 6 secs) (at 2016-03-08 10:09:04.053205) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 26 mins, 39 secs) (at 2016-03-08 10:09:04.053464) ========= /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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 10:09:04 INFO - MultiFileLogger online at 20160308 10:09:04 in /builds/slave/test 10:09:04 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 10:09:04 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:09:04 INFO - {'append_to_log': False, 10:09:04 INFO - 'base_work_dir': '/builds/slave/test', 10:09:04 INFO - 'blob_upload_branch': 'Fx-Team', 10:09:04 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:09:04 INFO - 'branch': 'Fx-Team', 10:09:04 INFO - 'buildbot_json_path': 'buildprops.json', 10:09:04 INFO - 'config_files': ('talos/mac_config.py',), 10:09:04 INFO - 'default_actions': ('clobber', 10:09:04 INFO - 'read-buildbot-config', 10:09:04 INFO - 'download-and-extract', 10:09:04 INFO - 'populate-webroot', 10:09:04 INFO - 'create-virtualenv', 10:09:04 INFO - 'install', 10:09:04 INFO - 'run-tests'), 10:09:04 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:09:04 INFO - 'download_minidump_stackwalk': True, 10:09:04 INFO - 'download_symbols': 'ondemand', 10:09:04 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:09:04 INFO - 'tooltool.py': '/tools/tooltool.py', 10:09:04 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:09:04 INFO - '/tools/misc-python/virtualenv.py')}, 10:09:04 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:09:04 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:09:04 INFO - 'installer_path': 'installer.exe', 10:09:04 INFO - 'log_level': 'info', 10:09:04 INFO - 'log_name': 'talos', 10:09:04 INFO - 'log_to_console': True, 10:09:04 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 10:09:04 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 10:09:04 INFO - 'opt_config_files': (), 10:09:04 INFO - 'pip_index': False, 10:09:04 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:09:04 INFO - 'cmd': ('bash', 10:09:04 INFO - '-c', 10:09:04 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:09:04 INFO - 'enabled': True, 10:09:04 INFO - 'halt_on_failure': False, 10:09:04 INFO - 'name': 'check_screen_resolution'},), 10:09:04 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:09:04 INFO - 'cmd': ('bash', 10:09:04 INFO - '-c', 10:09:04 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:09:04 INFO - 'enabled': True, 10:09:04 INFO - 'halt_on_failure': False, 10:09:04 INFO - 'name': 'check_screen_resolution'},), 10:09:04 INFO - 'run_cmd_checks_enabled': True, 10:09:04 INFO - 'sps_profile': False, 10:09:04 INFO - 'sps_profile_interval': 0, 10:09:04 INFO - 'suite': 'dromaeojs', 10:09:04 INFO - 'system_bits': '32', 10:09:04 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:09:04 INFO - 'title': 't-yosemite-r7-0108', 10:09:04 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:09:04 INFO - 'use_talos_json': True, 10:09:04 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:09:04 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:09:04 INFO - 'work_dir': 'build'} 10:09:04 INFO - ##### 10:09:04 INFO - ##### Running clobber step. 10:09:04 INFO - ##### 10:09:04 INFO - Running pre-action listener: _resource_record_pre_action 10:09:04 INFO - Running main action method: clobber 10:09:04 INFO - rmtree: /builds/slave/test/build 10:09:04 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:09:05 INFO - Running post-action listener: _resource_record_post_action 10:09:05 INFO - ##### 10:09:05 INFO - ##### Running read-buildbot-config step. 10:09:05 INFO - ##### 10:09:05 INFO - Running pre-action listener: _resource_record_pre_action 10:09:05 INFO - Running main action method: read_buildbot_config 10:09:05 INFO - Using buildbot properties: 10:09:05 INFO - { 10:09:05 INFO - "project": "", 10:09:05 INFO - "product": "firefox", 10:09:05 INFO - "script_repo_revision": "production", 10:09:05 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 10:09:05 INFO - "repository": "", 10:09:05 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 10:09:05 INFO - "buildid": "20160308090122", 10:09:05 INFO - "pgo_build": "False", 10:09:05 INFO - "basedir": "/builds/slave/test", 10:09:05 INFO - "buildnumber": 566, 10:09:05 INFO - "slavename": "t-yosemite-r7-0108", 10:09:05 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 10:09:05 INFO - "platform": "yosemite_r7", 10:09:05 INFO - "scheduler": "tests-fx-team-macosx64-talos", 10:09:05 INFO - "branch": "fx-team", 10:09:05 INFO - "repo_path": "integration/fx-team", 10:09:05 INFO - "revision": "9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d", 10:09:05 INFO - "stage_platform": "macosx64", 10:09:05 INFO - "builduid": "2af825ddece64556a242b57551c745f2", 10:09:05 INFO - "slavebuilddir": "test" 10:09:05 INFO - } 10:09:05 INFO - Found installer url https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg. 10:09:05 INFO - Running post-action listener: _resource_record_post_action 10:09:05 INFO - ##### 10:09:05 INFO - ##### Running download-and-extract step. 10:09:05 INFO - ##### 10:09:05 INFO - Running pre-action listener: _resource_record_pre_action 10:09:05 INFO - Running main action method: download_and_extract 10:09:05 INFO - mkdir: /builds/slave/test/build/tests 10:09:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:05 INFO - https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 10:09:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.test_packages.json 10:09:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.test_packages.json 10:09:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-47.0a1.en-US.mac.test_packages.json 10:09:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a1.en-US.mac.test_packages.json'}, attempt #1 10:09:07 INFO - Downloaded 1277 bytes. 10:09:07 INFO - Reading from file /builds/slave/test/build/firefox-47.0a1.en-US.mac.test_packages.json 10:09:07 INFO - Using the following test package requirements: 10:09:07 INFO - {u'common': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:09:07 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:09:07 INFO - u'firefox-47.0a1.en-US.mac.cppunittest.tests.zip'], 10:09:07 INFO - u'gtest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:09:07 INFO - u'firefox-47.0a1.en-US.mac.gtest.tests.zip'], 10:09:07 INFO - u'jittest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:09:07 INFO - u'jsshell-mac.zip'], 10:09:07 INFO - u'mochitest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:09:07 INFO - u'firefox-47.0a1.en-US.mac.mochitest.tests.zip'], 10:09:07 INFO - u'mozbase': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:09:07 INFO - u'reftest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:09:07 INFO - u'firefox-47.0a1.en-US.mac.reftest.tests.zip'], 10:09:07 INFO - u'talos': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:09:07 INFO - u'firefox-47.0a1.en-US.mac.talos.tests.zip'], 10:09:07 INFO - u'web-platform': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:09:07 INFO - u'firefox-47.0a1.en-US.mac.web-platform.tests.zip'], 10:09:07 INFO - u'webapprt': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:09:07 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:09:07 INFO - u'firefox-47.0a1.en-US.mac.xpcshell.tests.zip']} 10:09:07 INFO - Downloading packages: [u'firefox-47.0a1.en-US.mac.common.tests.zip'] for test suite category: common 10:09:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:07 INFO - https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 10:09:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:09:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:09:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:09:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip'}, attempt #1 10:09:08 INFO - Downloaded 17866513 bytes. 10:09:08 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:09:08 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 10:09:11 INFO - Return code: 0 10:09:11 INFO - Downloading packages: [u'firefox-47.0a1.en-US.mac.common.tests.zip', u'firefox-47.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 10:09:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:11 INFO - https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 10:09:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:09:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:09:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:09:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip'}, attempt #1 10:09:12 INFO - Downloaded 17866513 bytes. 10:09:12 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:09:12 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 10:09:16 INFO - Return code: 0 10:09:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:16 INFO - https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 10:09:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:09:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:09:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:09:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip'}, attempt #1 10:09:17 INFO - Downloaded 10845161 bytes. 10:09:17 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:09:17 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 10:09:17 INFO - Return code: 0 10:09:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:17 INFO - https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 10:09:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:09:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:09:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg 10:09:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg'}, attempt #1 10:09:20 INFO - Downloaded 110989422 bytes. 10:09:20 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:09:20 INFO - mkdir: /builds/slave/test/properties 10:09:20 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:09:20 INFO - Writing to file /builds/slave/test/properties/build_url 10:09:20 INFO - Contents: 10:09:20 INFO - build_url:https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:09:21 INFO - Running post-action listener: _resource_record_post_action 10:09:21 INFO - Running post-action listener: set_extra_try_arguments 10:09:21 INFO - ##### 10:09:21 INFO - ##### Running populate-webroot step. 10:09:21 INFO - ##### 10:09:21 INFO - Running pre-action listener: _resource_record_pre_action 10:09:21 INFO - Running main action method: populate_webroot 10:09:21 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:09:21 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:09:21 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:09:21 INFO - '--tppagecycles', 10:09:21 INFO - '7'], 10:09:21 INFO - 'tests': ['tsvgm']}}, 10:09:21 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 10:09:21 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:09:21 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 10:09:21 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:09:21 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:09:21 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:09:21 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:09:21 INFO - 'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:09:21 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:09:21 INFO - 'tests': ['damp', 'tps']}, 10:09:21 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:09:21 INFO - 'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['damp', 'tps']}, 10:09:21 INFO - 'g3': {'tests': ['dromaeo_dom']}, 10:09:21 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:09:21 INFO - 'other': {'tests': ['a11yr', 10:09:21 INFO - 'ts_paint', 10:09:21 INFO - 'tpaint', 10:09:21 INFO - 'sessionrestore', 10:09:21 INFO - 'sessionrestore_no_auto_restore', 10:09:21 INFO - 'tabpaint']}, 10:09:21 INFO - 'other-e10s': {'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['a11yr', 10:09:21 INFO - 'ts_paint', 10:09:21 INFO - 'tpaint', 10:09:21 INFO - 'sessionrestore', 10:09:21 INFO - 'sessionrestore_no_auto_restore', 10:09:21 INFO - 'tabpaint']}, 10:09:21 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['a11yr', 10:09:21 INFO - 'ts_paint', 10:09:21 INFO - 'tpaint', 10:09:21 INFO - 'sessionrestore', 10:09:21 INFO - 'sessionrestore_no_auto_restore', 10:09:21 INFO - 'tabpaint']}, 10:09:21 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['a11yr', 10:09:21 INFO - 'ts_paint', 10:09:21 INFO - 'tpaint', 10:09:21 INFO - 'sessionrestore', 10:09:21 INFO - 'sessionrestore_no_auto_restore', 10:09:21 INFO - 'tabpaint']}, 10:09:21 INFO - 'other_l64': {'tests': ['a11yr', 10:09:21 INFO - 'ts_paint', 10:09:21 INFO - 'tpaint', 10:09:21 INFO - 'sessionrestore', 10:09:21 INFO - 'sessionrestore_no_auto_restore', 10:09:21 INFO - 'tabpaint']}, 10:09:21 INFO - 'other_nol64': {'tests': ['a11yr', 10:09:21 INFO - 'ts_paint', 10:09:21 INFO - 'tpaint', 10:09:21 INFO - 'sessionrestore', 10:09:21 INFO - 'sessionrestore_no_auto_restore', 10:09:21 INFO - 'tabpaint']}, 10:09:21 INFO - 'svgr': {'tests': ['tsvgx', 10:09:21 INFO - 'tsvgr_opacity', 10:09:21 INFO - 'tart', 10:09:21 INFO - 'tscrollx', 10:09:21 INFO - 'cart']}, 10:09:21 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['tsvgx', 10:09:21 INFO - 'tsvgr_opacity', 10:09:21 INFO - 'tart', 10:09:21 INFO - 'tscrollx', 10:09:21 INFO - 'cart']}, 10:09:21 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:09:21 INFO - 'tests': ['tp5o']}, 10:09:21 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:09:21 INFO - 'talos_options': ['--e10s'], 10:09:21 INFO - 'tests': ['tp5o']}, 10:09:21 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:09:21 INFO - 'talos_options': ['--xperf_path', 10:09:21 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:09:21 INFO - 'tests': ['tp5n']}, 10:09:21 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:09:21 INFO - 'talos_options': ['--e10s', 10:09:21 INFO - '--xperf_path', 10:09:21 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:09:21 INFO - 'tests': ['tp5n']}}, 10:09:21 INFO - 'talos.zip': {'path': '', 10:09:21 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:09:21 INFO - Running post-action listener: _resource_record_post_action 10:09:21 INFO - ##### 10:09:21 INFO - ##### Running create-virtualenv step. 10:09:21 INFO - ##### 10:09:21 INFO - Running pre-action listener: _resource_record_pre_action 10:09:21 INFO - Running main action method: create_virtualenv 10:09:21 INFO - Creating virtualenv /builds/slave/test/build/venv 10:09:21 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 10:09:21 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:09:21 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:09:21 INFO - Using real prefix '/tools/python27' 10:09:21 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:09:22 INFO - Installing distribute.............................................................................................................................................................................................done. 10:09:25 INFO - Installing pip.................done. 10:09:25 INFO - Return code: 0 10:09:25 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:09:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:25 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 10:09:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 10:09:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:25 INFO - 'HOME': '/Users/cltbld', 10:09:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:25 INFO - 'LOGNAME': 'cltbld', 10:09:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:25 INFO - 'MOZ_NO_REMOTE': '1', 10:09:25 INFO - 'NO_EM_RESTART': '1', 10:09:25 INFO - 'PAGER': '/bin/cat', 10:09:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:25 INFO - 'PWD': '/builds/slave/test', 10:09:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:25 INFO - 'SHELL': '/bin/bash', 10:09:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:25 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:25 INFO - 'USER': 'cltbld', 10:09:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:25 INFO - 'XPC_FLAGS': '0x0', 10:09:25 INFO - 'XPC_SERVICE_NAME': '0', 10:09:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:25 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 10:09:25 INFO - Cleaning up... 10:09:25 INFO - Return code: 0 10:09:25 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 10:09:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:25 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 10:09:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 10:09:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:25 INFO - 'HOME': '/Users/cltbld', 10:09:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:25 INFO - 'LOGNAME': 'cltbld', 10:09:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:25 INFO - 'MOZ_NO_REMOTE': '1', 10:09:25 INFO - 'NO_EM_RESTART': '1', 10:09:25 INFO - 'PAGER': '/bin/cat', 10:09:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:25 INFO - 'PWD': '/builds/slave/test', 10:09:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:25 INFO - 'SHELL': '/bin/bash', 10:09:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:25 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:25 INFO - 'USER': 'cltbld', 10:09:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:25 INFO - 'XPC_FLAGS': '0x0', 10:09:25 INFO - 'XPC_SERVICE_NAME': '0', 10:09:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:25 INFO - Downloading/unpacking psutil>=0.7.1 10:09:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:09:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:09:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:09:28 INFO - Installing collected packages: psutil 10:09:28 INFO - Running setup.py install for psutil 10:09:28 INFO - building 'psutil._psutil_osx' extension 10:09:28 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 10:09:29 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 10:09:29 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 10:09:29 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 10:09:29 INFO - building 'psutil._psutil_posix' extension 10:09:29 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 10:09:29 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 10:09:29 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 10:09:29 INFO - ^ 10:09:29 INFO - 1 warning generated. 10:09:29 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 10:09:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:09:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:09:29 INFO - Successfully installed psutil 10:09:29 INFO - Cleaning up... 10:09:29 INFO - Return code: 0 10:09:29 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 10: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')]} 10:09:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10: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')]} 10:09:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:29 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 10:09:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 10:09:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:29 INFO - 'HOME': '/Users/cltbld', 10:09:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:29 INFO - 'LOGNAME': 'cltbld', 10:09:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:29 INFO - 'MOZ_NO_REMOTE': '1', 10:09:29 INFO - 'NO_EM_RESTART': '1', 10:09:29 INFO - 'PAGER': '/bin/cat', 10:09:29 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:29 INFO - 'PWD': '/builds/slave/test', 10:09:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:29 INFO - 'SHELL': '/bin/bash', 10:09:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:29 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:29 INFO - 'USER': 'cltbld', 10:09:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:29 INFO - 'XPC_FLAGS': '0x0', 10:09:29 INFO - 'XPC_SERVICE_NAME': '0', 10:09:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:30 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 10:09:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:32 INFO - Downloading mozsystemmonitor-0.0.tar.gz 10:09:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:09:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 10:09:32 INFO - Installing collected packages: mozsystemmonitor 10:09:32 INFO - Running setup.py install for mozsystemmonitor 10:09:32 INFO - Successfully installed mozsystemmonitor 10:09:32 INFO - Cleaning up... 10:09:32 INFO - Return code: 0 10:09:32 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:09:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:32 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:09:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:09:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:32 INFO - 'HOME': '/Users/cltbld', 10:09:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:32 INFO - 'LOGNAME': 'cltbld', 10:09:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:32 INFO - 'MOZ_NO_REMOTE': '1', 10:09:32 INFO - 'NO_EM_RESTART': '1', 10:09:32 INFO - 'PAGER': '/bin/cat', 10:09:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:32 INFO - 'PWD': '/builds/slave/test', 10:09:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:32 INFO - 'SHELL': '/bin/bash', 10:09:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:32 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:32 INFO - 'USER': 'cltbld', 10:09:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:32 INFO - 'XPC_FLAGS': '0x0', 10:09:32 INFO - 'XPC_SERVICE_NAME': '0', 10:09:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:33 INFO - Downloading/unpacking blobuploader==1.2.4 10:09:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:35 INFO - Downloading blobuploader-1.2.4.tar.gz 10:09:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:09:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:09:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:09:36 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:09:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:36 INFO - Downloading docopt-0.6.1.tar.gz 10:09:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:09:36 INFO - Installing collected packages: blobuploader, requests, docopt 10:09:36 INFO - Running setup.py install for blobuploader 10:09:36 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:09:36 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:09:36 INFO - Running setup.py install for requests 10:09:37 INFO - Running setup.py install for docopt 10:09:37 INFO - Successfully installed blobuploader requests docopt 10:09:37 INFO - Cleaning up... 10:09:37 INFO - Return code: 0 10:09:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:09:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:37 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 10:09:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:09:37 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:37 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:37 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:37 INFO - 'HOME': '/Users/cltbld', 10:09:37 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:37 INFO - 'LOGNAME': 'cltbld', 10:09:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:37 INFO - 'MOZ_NO_REMOTE': '1', 10:09:37 INFO - 'NO_EM_RESTART': '1', 10:09:37 INFO - 'PAGER': '/bin/cat', 10:09:37 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:37 INFO - 'PWD': '/builds/slave/test', 10:09:37 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:37 INFO - 'SHELL': '/bin/bash', 10:09:37 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:37 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:37 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:37 INFO - 'USER': 'cltbld', 10:09:37 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:37 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:37 INFO - 'XPC_FLAGS': '0x0', 10:09:37 INFO - 'XPC_SERVICE_NAME': '0', 10:09:37 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:09:37 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-AXfBV2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:09:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:09:37 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-pGuWn_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:09:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:09:37 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-OvnjT9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-79SqjE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-acJX2k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-OcV1aQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-aZY3QU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-VPiMQq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-eB8T97-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-O7Ziyr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-Pfw1Tj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-y3YHBh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:09:38 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-qCvY9l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:09:39 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-o7lTc8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:09:39 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-dEt4Ho-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:09:39 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-qyIHR5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:09:39 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-_0i8W6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:09:39 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:09:39 INFO - Running setup.py install for manifestparser 10:09:39 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:09:39 INFO - Running setup.py install for mozcrash 10:09:39 INFO - Running setup.py install for mozdebug 10:09:39 INFO - Running setup.py install for mozdevice 10:09:40 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Running setup.py install for mozfile 10:09:40 INFO - Running setup.py install for mozhttpd 10:09:40 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Running setup.py install for mozinfo 10:09:40 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Running setup.py install for mozInstall 10:09:40 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Running setup.py install for mozleak 10:09:40 INFO - Running setup.py install for mozlog 10:09:40 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:09:40 INFO - Running setup.py install for moznetwork 10:09:41 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:09:41 INFO - Running setup.py install for mozprocess 10:09:41 INFO - Running setup.py install for mozprofile 10:09:41 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:09:41 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:09:41 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:09:41 INFO - Running setup.py install for mozrunner 10:09:41 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:09:41 INFO - Running setup.py install for mozscreenshot 10:09:41 INFO - Running setup.py install for moztest 10:09:41 INFO - Running setup.py install for mozversion 10:09:42 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:09:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:09:42 INFO - Cleaning up... 10:09:42 INFO - Return code: 0 10:09:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:09:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:42 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 10:09:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:09:42 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:42 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:42 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:42 INFO - 'HOME': '/Users/cltbld', 10:09:42 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:42 INFO - 'LOGNAME': 'cltbld', 10:09:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:42 INFO - 'MOZ_NO_REMOTE': '1', 10:09:42 INFO - 'NO_EM_RESTART': '1', 10:09:42 INFO - 'PAGER': '/bin/cat', 10:09:42 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:42 INFO - 'PWD': '/builds/slave/test', 10:09:42 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:42 INFO - 'SHELL': '/bin/bash', 10:09:42 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:42 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:42 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:42 INFO - 'USER': 'cltbld', 10:09:42 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:42 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:42 INFO - 'XPC_FLAGS': '0x0', 10:09:42 INFO - 'XPC_SERVICE_NAME': '0', 10:09:42 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:09:42 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-amqW58-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:09:42 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 10:09:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:09:42 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-pBNjBW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:09:42 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)) 10:09:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:09:42 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-fOFe34-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:09:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:09:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:09:42 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-uGXxaH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:09:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:09:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:09:42 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-CWSpkt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:09:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 10:09:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:09:42 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-Bg86_m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:09:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 10:09:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:09:42 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-hv8Eaw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-g_i2hY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-7mzwDq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-J3LmTo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-j47sJB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-FGbXc_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-kKlwN0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-_W60at-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-hWeMQI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-Iv_8A5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 10:09:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:09:43 INFO - Running setup.py (path:/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/pip-U_TN42-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:09:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 10:09:44 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)) 10:09:44 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)) 10:09:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:09:44 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:09:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:09:44 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:46 INFO - Downloading blessings-1.6.tar.gz 10:09:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:09:46 INFO - Installing collected packages: blessings 10:09:46 INFO - Running setup.py install for blessings 10:09:46 INFO - Successfully installed blessings 10:09:46 INFO - Cleaning up... 10:09:46 INFO - Return code: 0 10:09:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:09:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:09:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:09:47 INFO - Reading from file tmpfile_stdout 10:09:47 INFO - Current package versions: 10:09:47 INFO - blessings == 1.6 10:09:47 INFO - blobuploader == 1.2.4 10:09:47 INFO - docopt == 0.6.1 10:09:47 INFO - manifestparser == 1.1 10:09:47 INFO - mozInstall == 1.12 10:09:47 INFO - mozcrash == 0.17 10:09:47 INFO - mozdebug == 0.1 10:09:47 INFO - mozdevice == 0.48 10:09:47 INFO - mozfile == 1.2 10:09:47 INFO - mozhttpd == 0.7 10:09:47 INFO - mozinfo == 0.9 10:09:47 INFO - mozleak == 0.1 10:09:47 INFO - mozlog == 3.1 10:09:47 INFO - moznetwork == 0.27 10:09:47 INFO - mozprocess == 0.22 10:09:47 INFO - mozprofile == 0.28 10:09:47 INFO - mozrunner == 6.11 10:09:47 INFO - mozscreenshot == 0.1 10:09:47 INFO - mozsystemmonitor == 0.0 10:09:47 INFO - moztest == 0.7 10:09:47 INFO - mozversion == 1.4 10:09:47 INFO - psutil == 3.1.1 10:09:47 INFO - requests == 1.2.3 10:09:47 INFO - wsgiref == 0.1.2 10:09:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:09:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:47 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 10:09:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:09:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:47 INFO - 'HOME': '/Users/cltbld', 10:09:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:47 INFO - 'LOGNAME': 'cltbld', 10:09:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:47 INFO - 'MOZ_NO_REMOTE': '1', 10:09:47 INFO - 'NO_EM_RESTART': '1', 10:09:47 INFO - 'PAGER': '/bin/cat', 10:09:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:47 INFO - 'PWD': '/builds/slave/test', 10:09:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:47 INFO - 'SHELL': '/bin/bash', 10:09:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:47 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:47 INFO - 'USER': 'cltbld', 10:09:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:47 INFO - 'XPC_FLAGS': '0x0', 10:09:47 INFO - 'XPC_SERVICE_NAME': '0', 10:09:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:09:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:09:47 INFO - Cleaning up... 10:09:47 INFO - Return code: 0 10:09:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:09:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:47 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 10:09:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 10:09:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:47 INFO - 'HOME': '/Users/cltbld', 10:09:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:47 INFO - 'LOGNAME': 'cltbld', 10:09:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:47 INFO - 'MOZ_NO_REMOTE': '1', 10:09:47 INFO - 'NO_EM_RESTART': '1', 10:09:47 INFO - 'PAGER': '/bin/cat', 10:09:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:47 INFO - 'PWD': '/builds/slave/test', 10:09:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:47 INFO - 'SHELL': '/bin/bash', 10:09:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:47 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:47 INFO - 'USER': 'cltbld', 10:09:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:47 INFO - 'XPC_FLAGS': '0x0', 10:09:47 INFO - 'XPC_SERVICE_NAME': '0', 10:09:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:47 INFO - Downloading/unpacking jsonschema 10:09:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:49 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:09:49 INFO - Downloading/unpacking functools32 (from jsonschema) 10:09:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:50 INFO - Downloading functools32-3.2.3-2.tar.gz 10:09:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:09:50 INFO - warning: no files found matching '*.txt' 10:09:50 INFO - no previously-included directories found matching 'build' 10:09:50 INFO - no previously-included directories found matching 'dist' 10:09:50 INFO - no previously-included directories found matching '.git*' 10:09:50 INFO - Installing collected packages: jsonschema, functools32 10:09:50 INFO - Running setup.py install for functools32 10:09:50 INFO - warning: no files found matching '*.txt' 10:09:50 INFO - no previously-included directories found matching 'build' 10:09:50 INFO - no previously-included directories found matching 'dist' 10:09:50 INFO - no previously-included directories found matching '.git*' 10:09:50 INFO - Successfully installed jsonschema functools32 10:09:50 INFO - Cleaning up... 10:09:50 INFO - Return code: 0 10:09:50 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 10:09:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:09:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:09:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:09:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:09:50 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 0x105a9da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105aa54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8a89573bc0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, '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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:09:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 10:09:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 10:09:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:09:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:09:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:09:50 INFO - 'HOME': '/Users/cltbld', 10:09:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:09:50 INFO - 'LOGNAME': 'cltbld', 10:09:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:09:50 INFO - 'MOZ_NO_REMOTE': '1', 10:09:50 INFO - 'NO_EM_RESTART': '1', 10:09:50 INFO - 'PAGER': '/bin/cat', 10:09:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:09:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:09:50 INFO - 'PWD': '/builds/slave/test', 10:09:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:09:50 INFO - 'SHELL': '/bin/bash', 10:09:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:09:50 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:09:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:09:50 INFO - 'USER': 'cltbld', 10:09:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:09:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:09:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:09:50 INFO - 'XPC_FLAGS': '0x0', 10:09:50 INFO - 'XPC_SERVICE_NAME': '0', 10:09:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:09:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:09:50 INFO - Downloading/unpacking flake8 10:09:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:53 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 10:09:53 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 10:09:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:53 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 10:09:53 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 10:09:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:53 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 10:09:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:09:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:09:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:09:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 10:09:54 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:09:54 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:09:54 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:09:54 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:09:54 INFO - no previously-included directories found matching 'docs/_build' 10:09:54 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 10:09:54 INFO - Running setup.py install for pep8 10:09:54 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:09:54 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:09:54 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:09:54 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:09:54 INFO - no previously-included directories found matching 'docs/_build' 10:09:54 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 10:09:54 INFO - Successfully installed flake8 mccabe pyflakes pep8 10:09:54 INFO - Cleaning up... 10:09:54 INFO - Return code: 0 10:09:54 INFO - Running post-action listener: _resource_record_post_action 10:09:54 INFO - Running post-action listener: _start_resource_monitoring 10:09:54 INFO - Starting resource monitoring. 10:09:54 INFO - ##### 10:09:54 INFO - ##### Running install step. 10:09:54 INFO - ##### 10:09:54 INFO - Running pre-action listener: _resource_record_pre_action 10:09:54 INFO - Running main action method: install 10:09:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:09:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:09:55 INFO - Reading from file tmpfile_stdout 10:09:55 INFO - Detecting whether we're running mozinstall >=1.0... 10:09:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:09:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:09:55 INFO - Reading from file tmpfile_stdout 10:09:55 INFO - Output received: 10:09:55 INFO - Usage: mozinstall [options] installer 10:09:55 INFO - Options: 10:09:55 INFO - -h, --help show this help message and exit 10:09:55 INFO - -d DEST, --destination=DEST 10:09:55 INFO - Directory to install application into. [default: 10:09:55 INFO - "/builds/slave/test"] 10:09:55 INFO - --app=APP Application being installed. [default: firefox] 10:09:55 INFO - mkdir: /builds/slave/test/build/application 10:09:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 10:09:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 10:10:29 INFO - Reading from file tmpfile_stdout 10:10:29 INFO - Output received: 10:10:29 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 10:10:29 INFO - Running post-action listener: _resource_record_post_action 10:10:29 INFO - ##### 10:10:29 INFO - ##### Running run-tests step. 10:10:29 INFO - ##### 10:10:29 INFO - Running pre-action listener: _resource_record_pre_action 10:10:29 INFO - Running main action method: run_tests 10:10:29 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:10:29 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:10:29 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:10:29 INFO - 2016-03-08 10:10:29.208 screenresolution[1646:7989] starting screenresolution argv=screenresolution get 10:10:29 INFO - 2016-03-08 10:10:29.211 screenresolution[1646:7989] Display 0: 1600x1200x32@60 10:10:29 INFO - 2016-03-08 10:10:29.216 screenresolution[1647:7992] starting screenresolution argv=screenresolution list 10:10:29 INFO - Available Modes on Display 0 10:10:29 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:10:29 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:10:29 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:10:29 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:10:29 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:10:29 INFO - Intel Iris: 10:10:29 INFO - Chipset Model: Intel Iris 10:10:29 INFO - Type: GPU 10:10:29 INFO - Bus: Built-In 10:10:29 INFO - VRAM (Dynamic, Max): 1536 MB 10:10:29 INFO - Vendor: Intel (0x8086) 10:10:29 INFO - Device ID: 0x0a2e 10:10:29 INFO - Revision ID: 0x0009 10:10:29 INFO - Displays: 10:10:29 INFO - Display: 10:10:29 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:10:29 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:10:29 INFO - Display Serial Number: 1600x1200 60 10:10:29 INFO - Main Display: Yes 10:10:29 INFO - Mirror: Off 10:10:29 INFO - Online: Yes 10:10:29 INFO - Rotation: Supported 10:10:29 INFO - Return code: 0 10:10:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:10:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:10:29 INFO - Python 2.7.3 10:10:29 INFO - Return code: 0 10:10:29 INFO - grabbing minidump binary from tooltool 10:10: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')]} 10:10:29 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 0x105941d30>, '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 0x105765db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x105938b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:10:29 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 10:10:29 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 10:10:29 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:10:29 INFO - Return code: 0 10:10:29 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 10:10:29 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:10:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:10:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 10:10:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:10:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 10:10:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 10:10:30 INFO - Return code: 0 10:10:30 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/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0108', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 10:10:30 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/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0108 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 10:10:30 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.BwOIFmRSzI/Render', 10:10:30 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:10:30 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:10:30 INFO - 'HOME': '/Users/cltbld', 10:10:30 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:10:30 INFO - 'LOGNAME': 'cltbld', 10:10:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:10:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 10:10:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:10:30 INFO - 'MOZ_NO_REMOTE': '1', 10:10:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:10:30 INFO - 'NO_EM_RESTART': '1', 10:10:30 INFO - 'PAGER': '/bin/cat', 10:10:30 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:10:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:10:30 INFO - 'PWD': '/builds/slave/test', 10:10:30 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:10:30 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:10:30 INFO - 'SHELL': '/bin/bash', 10:10:30 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AHRjOHMSKK/Listeners', 10:10:30 INFO - 'TMPDIR': '/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/', 10:10:30 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:10:30 INFO - 'USER': 'cltbld', 10:10:30 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:10:30 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:10:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:10:30 INFO - 'XPC_FLAGS': '0x0', 10:10:30 INFO - 'XPC_SERVICE_NAME': '0', 10:10:30 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:10:30 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/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0108', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 10:10:30 INFO - mozversion application_buildid: 20160308090122 10:10:30 INFO - mozversion application_changeset: 9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d 10:10:30 INFO - mozversion application_display_name: Nightly 10:10:30 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:10:30 INFO - mozversion application_name: Firefox 10:10:30 INFO - mozversion application_remotingname: firefox 10:10:30 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 10:10:30 INFO - mozversion application_vendor: Mozilla 10:10:30 INFO - mozversion application_version: 47.0a1 10:10:30 INFO - mozversion platform_buildid: 20160308090122 10:10:30 INFO - mozversion platform_changeset: 9b6dc52f6012ef7e40311c1d1bca0ed820f26c3d 10:10:30 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 10:10:30 INFO - mozversion platform_version: 47.0a1 10:10:30 INFO - using testdate: 1457460630 10:10:30 INFO - actual date: 1457460630 10:10:30 INFO - starting webserver on 'localhost:49271' 10:10:30 INFO - SUITE-START | Running 2 tests 10:10:30 INFO - TEST-START | dromaeo_css 10:10:30 INFO - operating with platform_type : mac_ 10:10:30 INFO - Initialising browser for dromaeo_css test... 10:10:30 INFO - TEST-INFO | started process 1665 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/tmp5m3FHn/profile http://localhost:49271/getInfo.html) 10:10:33 INFO - PROCESS | 1665 | __metrics Screen width/height:1600/1200 10:10:33 INFO - PROCESS | 1665 | colorDepth:24 10:10:33 INFO - PROCESS | 1665 | Browser inner width/height: 1024/689 10:10:33 INFO - PROCESS | 1665 | __metrics 10:10:33 INFO - PROCESS | 1665 | 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" 10:10:33 INFO - PROCESS | 1665 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:10:34 INFO - TEST-INFO | 1665: exit 0 10:10:34 INFO - Browser initialized. 10:10:34 INFO - Running cycle 1/1 for dromaeo_css test... 10:10:34 INFO - TEST-INFO | started process 1669 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/tmp5m3FHn/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:10:45 INFO - PROCESS | 1669 | RSS: Main: 245796864 10:10:45 INFO - PROCESS | 1669 | 10:11:37 INFO - PROCESS | 1669 | 1457460697177 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 10:13:46 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49271/tests/dromaeo/cssquery-ext.html) 10:13:48 INFO - PROCESS | 1669 | RSS: Main: 377061376 10:13:48 INFO - PROCESS | 1669 | 10:16:50 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-ext.html (next: http://localhost:49271/tests/dromaeo/cssquery-jquery.html) 10:16:51 INFO - PROCESS | 1669 | RSS: Main: 382304256 10:16:51 INFO - PROCESS | 1669 | 10:19:53 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49271/tests/dromaeo/cssquery-mootools.html) 10:19:54 INFO - PROCESS | 1669 | RSS: Main: 375377920 10:19:54 INFO - PROCESS | 1669 | 10:22:56 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49271/tests/dromaeo/cssquery-prototype.html) 10:22:56 INFO - PROCESS | 1669 | RSS: Main: 333623296 10:22:56 INFO - PROCESS | 1669 | 10:26:00 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49271/tests/dromaeo/cssquery-yui.html) 10:26:00 INFO - PROCESS | 1669 | RSS: Main: 337637376 10:26:00 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-yui.html (next: http://localhost:49271/tests/dromaeo/cssquery-dojo.html) 10:29:03 INFO - PROCESS | 1669 | RSS: Main: 427659264 10:29:03 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | __start_tp_report 10:29:03 INFO - PROCESS | 1669 | _x_x_mozilla_page_load 10:29:03 INFO - PROCESS | 1669 | _x_x_mozilla_page_load_details 10:29:03 INFO - PROCESS | 1669 | |i|pagename|runs| 10:29:03 INFO - PROCESS | 1669 | |0;dojo.html;3404.2340473393488;3428.982855085723;3471.913202169944;3496.4930085137657;3517.3317069756745;5551.805686800963;5597.328320601523;5610.186522954169;5611.719414029298;5617.466340697632;5461.617686761928;5465.398806131322;5480.835574932748;5499.560035197184;5500.312460942382;5005.199168133099;5017.37282839645;5039.168537191359;5096.082705113078;5099.235114732783;5065.341505604285;5103.821366252182;5108.6168537359845;5110.463401342861;5119.1809310510325;4986.551210391064;5031.547160755531;5036.6726162799305;5077.59379249661;5096.668716533432;4842.757862106916;5114.360704911886;5151.381834179885;5172;5213.556847667934;5009.799608015675;5030.647854650176;5082.898342033176;5092.6180536459915;5127.128388174019;5461.262729531502;5485.533729632986;5508.173773933902;5541.445855414467;5600.803971860965;6164.630122192638;6177.752889884399;6186.103015062836;6206.975848984957;6208.099825525319;4990.87522811929;6078.635281883101;6206.162168107293;6255.280642726099;6259;5725.742341594639;5726.742296596663;5733.996550603628;5744.080947048494;5746.080627099644;6234.37656234382;6273;6274.372562743781;6293.118963345044;6296.874062518724;5991.760329586855;6040.758369665252;6104.26748790148;6114.694265286718;6143.477804386677;6146.938530614637;6187.226596675416;6202.317745048041;6204.782832600928;6229.906551401733;6144.446999770043;6149.815505534841;6150.446459818638;6157.138000679908;6160.983437732813;6067.605605635619;6111.804454079507;6111.865232675468;6186.628802271788;6193.38066193377;4108.712390132662;4835.516448355207;4853.247746599282;4878.8780280492565;4880.853574392774;4345.261305578059;4365.825366985348;4374.868753937387;4389.253826849444;4434.290513517822;5470.17947307907;5497.5601951843755;5574.219609254707;5574.9721251393485;5576.33084029919;6129.756146212572;6131.651934473265;6256.0303153011355;6267.0286105653695;6280.654563998933;4666.416697912761;5523.337199536001;5574.414686457863;5588.580856435784;5589.552835773128;5202.167653175549;5293.629445938747;5295.708736019479;5302.655327403783;5351.919721204185;5347.304850369427;6174.9073763893575;6222.408871157233;6250.531210159165;6253.96873015632;6181.350958149509;6199.907001395073;6229.875402492015;6236.407541283571;6239.220097487814;6188.721507532082;6205.410486003822;6257.217847769029;6308.71610777507;6317.210348706411;6109.586862300737;6120.816375508742;6140.478059365004;6142.539309551891;6162.075688646739;6156.846078848064;6221.688915554295;6230.221222347207;6239.376062393724;6245.5628106033955;5865.192996754751;5896.204012458435;5961.195238642727;6012.188354572252;6036.6679832609625;6038.365971572922;6045.6070355426755;6045.727942242697;6064.241969753781;6079.392060793885;4972.005598880311;5779.971100144472;5852.502537284378;5868.94131058701;5874.970625146847;4972.701637901738;5846.123081537803;5913.497352725067;5952.315483719254;6082.422169893853;5793.333766616893;5796.333421656394;5839.270091238595;5841.977653910463;5843.707814609337 10:29:03 INFO - PROCESS | 1669 | |1;ext.html;498.6235392278829;583.667309633509;584.6608966799254;606.4511616986628;632.8576070384163;30503.54244686329;30858.691413085864;30875.69124308759;30907.690923090762;39173.608263917355;42884.78557607208;43232;43329.133417331635;43358.783206084;43437.7828110859;9547.61809527618;9798.461084640341;9802.41185528867;9805.558749856273;9820;9585.66450174244;9696.078872507136;9703.563339649698;9715.854262186072;9725.854112188323;9660.613575457008;9905.603775848957;9912.05835445635;9912.504374781232;9913.603455861758;9809.803803923953;9875;9880.258980576486;9881.555330010167;9882.555285012191;9593.616255349847;9729.805403891953;9730.562124704406;9736.367136136128;9743.074407931306;34304;42691.01162918597;42774;42784.78607606973;42855.35716964248;3352.2457447074457;3396.3716712408036;3478.704310133616;3778.754380965256;3838.1556057667267;28897.988570399935;29563.556546651816;30612.387752245053;30702.84648576765;30768.84615576908;2766;2778.597103419993;2791.6929137794828;2849.700781417963;2861.699521550228;496607.51696241647;499841;500991;501562.4453144159;502567;69066.9639955401;69901.95147072797;70435;70461.64769176223;70482;74307;74616.62691686506;75000.62499687467;76185.6190719054;76472.23527764762;17204.053777042132;17429.21568529419;17467.82532174662;17495.212715427835;17498.56253593645;13153.539626113232;13187.208767473981;13192.670183245496;13209.867901320864;13215.074944753775;21899.343019709435;22527.31045171619;22662.546749064928;22701.43246418853;22717.977691003944;8638.913610863936;9012.549372531346;9425.434473931586;9664.226861851035;9680.903190968;885.5616469847466;973.3478569358405;986.413084214891;996.4718699089494;1020.831562792131;29504;29746;29781;30517.694823051486;30621.540676889865;1035.7777822169912;1110.8889111088988;1142.3150852492672;1149.6206251937008;1189.3993533265646;14978.325975331136;15222.923885380502;15228.46700365504;15304.158271295186;15638.45265415705;528301;535791;536235;536717;539033;59556.40443595508;61689;61785.69107154435;61829.07256391158;61961.690191548754;1344.9663758406118;1359.9252041137831;1470.5882352941194;1474.4839306242943;1502.6393665520197;22006.339809805733;28698;29104.854475727487;29376;29804.70195298019;47201.58395248148;47472;48060.27909581289;48065.03869922512;48117.75941120412;294768;296707;296904;297554;298157;27805.582916256677;33503.16242093967;33610.49584256287;34681.47977780285;35150;42464.78767606142;42640.1471970565;42661.36007959821;42760.78619606882;43086.78456607697;33885;34856.30287394187;34866.82566587151;35677;35745.28509429745;31478.426078696433;34687.65312346945;35088.47367289544;35663.64336356603;35672;30476.390472190877;34792.82603586966;37173.814130929175;37334;38072.85781426562;28169.43661126807;30467.93362232311;31641.16241761477;32460;32831.343373131924;22696.886515567316;24069.759302407452;24418.755812441646;24528.87735561311;24918.12786552462 10:29:03 INFO - PROCESS | 1669 | |2;jquery.html;313.5938959048033;367.5057048270076;369.67653303359543;374.1021548284119;377.1194261399632;19654.606907861835;19828.008599570017;20444;20445.59108817823;20470.87410192439;19512.804871951277;20305.60373482352;20884.686729699068;20895.895520522416;20899.133660272822;5920.585559010871;6037;6049.1228771828055;6097;6120.969395153018;4282.122164956177;4571.954280457203;6035.6076855004285;6709.6980635871505;6730.966345168292;6634;6641.601503909781;6642.800715978528;6645.43513801325;6648.135742353512;5540.695261760601;5781.392953739839;5792.044312688401;5800.187973683687;6611.371919667624;3755.8497660093562;5400.270963419966;5530.834074977717;5615.859603509904;5630.127330263816;12743.235405875677;12784.61646150617;12795;12959.352032398436;12986.935065324707;1832.5968286976845;2282.2468585366955;2320.33870346952;2348.3189874936247;2503.574392353304;9517.381370210915;9581.329306948517;9671.90328096724;9954.203663706887;9967.70096897087;1730.731736580832;1776.671315806567;1807.493901707524;1811.148760082759;1834.642244762272;77429;103425.44861827079;113628;113840;116187;11063.944680276709;11235.494402751896;11258.324500529994;11258.831117533244;11358.26171298863;13743.175409475463;13799.103058301178;13801;13814.171149731048;13856.93071534636;7001.684924178424;7070.964645176741;8547.487150770974;8624.396292259482;8740.21338079576;8813;8820.647174113092;8857.822843543094;8917.509536975398;8925.419847709878;4392.1874453226255;4467.396901418267;4484.798184081724;4528.705634133771;4562.520935301745;1618.6681730245507;1649.4144578674398;1848.5471059590218;1894.4032629721594;1899.620075984781;895.4492986813193;920.3985065985138;987.0327079462168;993.9850902236473;1007.3905287301224;19198.040097995043;19585.706214406797;19784.90107549453;19807.60384792296;19980.10089545974;972.8297547929226;974.3520558828442;992.4938281476354;997.3118548201718;1014.9188064954934;10366.274360794823;10693.625723099654;10704.839427408595;10716.839247411295;10921.290116142425;551903.2404838031;631178;648720;661570;661720;114092;117339.41330293294;117378;120005;121561;868.3877866104381;974.741693451236;1066.7279843639822;1080.8432777247256;1084.7017070305728;16053.919730401274;17403.912980435016;17657.293708251527;17710.557236069202;17726.10025794323;35943;50414.49585504098;50844;50948.74525627348;50966;72234;72835;72986.63506682432;75164.62417687876;75278;7644.235576442311;7887.921120788948;8070.435069545076;8084.555349455602;8092.6762929482165;7821.1005734339005;11325.603603873826;12708.87291127077;12763.872361276268;13569.93215033958;11188.496517656888;11276.830847537129;11297.548098075986;11390.487428065922;11537.03870342027;10935.671929842118;10966.232363734462;10999.835002475129;11140.610078647209;11188.440577971232;11258.324500529994;11412.657620271406;11534.134939879375;11682;11731.23746956445;7747.496412733154;7968.16334284915;8018.719344822904;8060.11338752725;8197.262246397853;9507.809843802946;10739.731506712395;10798.028177464066;11419.486123124314;11640.708982275512 10:29:03 INFO - PROCESS | 1669 | |3;mootools.html;1430.8283006039264;1567.4357231396696;1594.2666373468205;1878.2299257304498;2025.7062725904743;8036.959815200923;8671.262942649875;8846.5134417607;8856.468611883292;8857.689980850664;8649.870251946226;8655.740327790176;8762.12378762125;8762.21140097391;8783.516906570136;2172.728408948881;2450.595651717469;2483.379155211197;2488.8008959283306;2490.1160088168713;2156.6657168138886;2457.8771061446946;2519.924402267935;2520.962185567218;2521.1680145552014;2384.833061685683;2427.7693619106158;2436.9634455483183;2438.878056097197;2448.6204638281097;2432.8661923594195;2451.6567680524563;2452.901883924641;2456.852588844666;2462.54442928058;2475.8762061897014;2482.987585062081;2485.968323145892;2487.8134139939575;2495.1765917247267;8871.866921996176;8918.42030268037;8918.910810891874;8921.330900182447;8935.240504557121;5305.8938821223355;5552.639078459887;5552.833414997556;5557.972210138923;5568.025595520768;3460.723142148622;3484.790912545255;3486.2330287336745;3531.0113168312914;3553.626869178751;1003.8393856982848;1621.3433559408459;1662.6342204714942;1679.7144485437504;1683.1163639089575;11922.403879805976;12006.279623222546;12044.45799938996;12051.758964820654;12055.578054768128;4665.650076244296;4713.622910167179;4729.290606409066;4789.976050119727;4792.7603619819565;9440.24478041755;9489.1934185595;9491.098345657152;9495.620175192915;9501.477418741897;5412.296401467784;5455.645383050089;5459.798844254257;5463.590230732711;5465.617406781566;4506.3465797459185;4602.05657840142;4831.0820944020525;5022.296878437021;5026.145555255543;3268.4770436730487;3705.796181210005;3749.025253434072;3775.811209439572;3778.905527361783;1150.1201580790703;1160.1762748448696;1165.143619439711;1166.3993043582561;1180.6281021478208;1213.7815193265296;1378.179982910167;1420.403430559147;1420.4744244629553;1421.7227640610188;8057.153998830038;8334.541600212047;8338.541380224025;8341.332693384515;8352.83294334122;503.4487236476053;512.397932429394;521.3379008659058;523.4216191108846;524.551508460261;6340.3342649022115;6348.301686814447;6437.324080971524;6448.871022579522;6449.484041276686;10397.63608273722;10705.89294107049;10713.732156696145;10747.30142540748;10881.891181088246;10402.323848949794;10576.4711764413;10702.785944281226;10704.19718521114;10712.517936692868;8380.706675266336;8469.195426434479;8487.575621218914;8549.358798090168;8551.828963420698;7828.334591559781;8077.7576672699915;8092.797680058045;8094.433389662667;8099.87850182236;9323.533823308942;9546.57040433196;9622.807543848943;9757.512124393894;9834.704958851245;9666.516674166403;9945.701628951143;9947.552360143665;10074.345167564084;10077.899221007696;6367.649779262185;6833.940739185434;6985.895211571932;7054.047703559953;7178.641067946477;8409.285210756909;8424.28393586552;8452.74641760748;8460.746177614681;8466.322694184328;7398.519096258726;7503.287187717158;7544.132424771002;7564.130125035691;7627.427942904415;7213.350798428167;7219.061522002106;7252.4560657949805;7321.121465424183;7345.375643070185;7904.604769761374;7914.762557123296;7934.841303173789;7946.602669866599;7947.443678942419;6703.363180497845;6901.516893817586;7102.254263302279;7147.463940204401;7159.8568028640175;7079.893801592877;7085.6457177141965;7125.35871771543;7135.82160445993;7157.498975071695 10:29:03 INFO - PROCESS | 1669 | |4;prototype.html;326.15525788208544;327.70670250126136;334.7773730469238;335.2373350627323;337.6690842973887;6441.549091563593;6599.637019963906;6613.437857782088;6614.735410583571;6647.667616619174;6581.2760596334365;6608.471322294217;6609.669516524166;6612.23959244687;6617.90804517254;4682.555157260055;4737.170995075865;4784.880377990561;4853.39332583427;4915.75421228938;4817.22924332107;4836.37127173467;4848.781804818792;4853.02939412119;4871.780769865347;4800.039992001596;4804.759762011903;4808.735519546423;4814.662973591832;4816.807327706905;4670.2060649689465;4687.859364219096;4784.473707892129;4794.089123066607;4813.061453016663;3382.915427114342;4096.877093687164;4119.0937993641355;4122.628963393279;4130.56629053948;6335.176427064498;6337.081123237151;6338.968305158491;6344.429001389897;6365.363463653597;4413.801378937924;5684.459976302286;5726.7995620153515;5729.856753581152;5734.311882574076;5361.276227709248;5703.686297253649;7016.75441359555;7023.367896889305;7036.226015138331;4265.253580623409;4392.604665580081;4402.581754733295;4404.317330813729;4409.1843009043105;7216.67524961378;7333.963330183368;7443.2556744325675;7443.851122977564;7461.030066091427;4587.954120458753;4590.517995610479;4590.862274131715;4592.770361481913;4596.5863072323655;4647.907041859144;4653.604443622262;4656.185167595657;4661.463931647836;4675.976620116946;5580.469855363734;5581.10702287632;5585.050541407971;5596.636218645775;5596.664200148004;6736.157980252468;7033.156021277479;7072.434205263567;7075.681594328267;7133.5719856808755;1610.3236640610971;1619.2632352279684;1626.9912654154264;1629.7881275434117;1630.8776841736917;832;967.2455484721928;1023.125227930124;1032.6747074671455;1061.543536279392;6342.889994250988;6544.574602650812;6582.111414959015;6709.496787740939;6717.16035495563;7364.742234021784;7382.74160404394;7384.778456646309;7399.556026638419;7411.999380083727;5385.434529374437;5516.310461192351;6706.899396509057;6712.630805305755;6716.194056713226;3847.3459511883048;3882.941755873664;3889.241597888441;3891.552471465761;3892.143728379752;6569.868602628017;7381.926180738231;7426.554406735613;7645.350145237717;7645.541267523967;7458.85082298351;7530.962345188349;7531.623418829036;7534.982777324991;7608.505447145918;7680.155182929873;7697.538147711043;7697.807554811175;7703.460757747016;7712.5758083305955;7124.038254835531;7248.56508609464;7369.115706115301;7376.520526165782;7380.667869945973;7177.533460325271;7231.746888858865;7235.2041275458605;7249.891251631124;7254.709811607477;7650;7665.770026899202;7693.769186924401;7699.961500192463;7702.152763195932;4585.564371384713;4625.375574297427;4635.536446355338;4641.187792136295;4649.465311489222;6991.230964593992;7333.523320984119;7334.193238743627;7338.596377199306;7347.595882226315;6098.878022439438;6774.3225677431865;7034.261402552863;7036.331548502884;7107.644617769194;7084.504084714021;7088.539244949062;7090.858182836211;7090.893636595352;7092.787216383516;5645.633033852787;6897.620630865351;6907.240203577703;6908.620025898624;6923.2038315594355;6772.627505487246;6982.895256571257;7080.716771329089;7094.417319253744;7095.9645201773665;6617.172853393326;6701.396874281338;6724.260331363644;6812.318768123148;6883.380495755406 10:29:03 INFO - PROCESS | 1669 | |5;yui.html;718.8490417012428;757.8711619024768;780.0171783552723;783.8393129408472;790.778581997041;15169;15315;15319.846801531981;15330.15684137372;15332.770008449883;14040.929795351009;14125.78811317831;14150.433982640681;14151.93860460467;14170.433182672681;770.4298818874049;779.8986131802858;918.8254231695989;939.2063706168294;962.6823148361024;945.2863088368273;952.6618050592044;952.7760976170595;955.69895482923;956.9569169605129;1012.185190921308;1012.8632634594309;1017.2421545948242;1017.9083882450578;1018.4653057145022;799.8360336131079;988.5798535622367;1006.6225165562914;1012.0790081026231;1012.7518757904287;752.5259086775351;753.7927070055724;754.3474894216463;755.6788364944877;757.5946868425366;15090.245487725679;15148.545543633709;15167.772483412758;15180.696386072326;15196.240187990667;10785.78428431427;12650.114491985565;12732.936335318356;12907.354632268443;12989.155704879247;10029.799404011952;10039.196864250915;10087.243456740774;10159.4920253987;10945.890541094566;3591.6228795976567;3619.312330657193;3623.347797396494;3702.2780557791243;3716.163863130801;83288.58355708243;83711.58144209301;83835;84150.57924710338;84284;8111.432199746079;9823.508824558743;9902.950485247527;10098.949505252574;10679.83980240297;18481.90759046196;22053.22813701513;22329;22361.776382236294;22369;7619;7619.390448764086;7650.273224043707;7755.961220193863;7824.84350313002;4067.1458993611673;4117.3206420940205;4121.567235440296;4124.938125928114;4128.504579450485;3412.368711788327;3446.190145315849;3453.4977284881156;3464.8960531184107;3467.826608669556;575.4763165519357;625.337142628815;625.587725810443;636.8949123394588;685.6982927511879;518.4763388977085;580.6281340723109;591.6243185577104;627.7614506487505;646.8059582125344;7687.769366919001;8201.589920503951;8260.339172866155;8325;8512.361572881935;551.969641669704;557.4342042826535;583.5564970622357;628.7799270255374;639.8098397999338;3766.868159614455;3848.9230215395537;3852.8266228019806;3970.166265084307;4139.606737359946;87697.80755481165;91963.54018229866;93696;93964;94139.52930235305;79901.60049199717;80904;81063;81683;81880;68607.97088043683;69235;69838.65080674565;69859.65070174719;71081;7771.8834217485655;7778.222177782177;7789.6884124636645;7833.725819596287;7920.445568810128;31404.685953141092;44582.43961461333;44955.10089798251;45267;45586.772066139456;60967;62877;64707.029394560064;65577.67211163914;65893;9166;9438.96171421157;10733.971857867855;11262.605808796652;11694;12113.576024839089;12305.692357690772;12381.690457738268;12436.875631243935;12624.55814046504;11657.53369865196;11693.415329233674;11749.823752643888;11788.705282367666;11865.347405892759;11534.711632208926;11567.248128871597;11877.406129693654;11897.702557436134;11945.761084778429;9157.679481218393;11244.437778111225;11300.717482063013;11551.306921584732;11576.710582235512;9771.267154963263;9790.804183916423;9942.751431214278;9961.40231586107;10060.39637621745;6986;8462.238398544161;8852.24755895756;8966.327525435749;9652.131308182297 10:29:03 INFO - PROCESS | 1669 | __end_tp_report 10:29:03 INFO - PROCESS | 1669 | __start_cc_report 10:29:03 INFO - PROCESS | 1669 | _x_x_mozilla_cycle_collect,1357 10:29:03 INFO - PROCESS | 1669 | __end_cc_report 10:29:03 INFO - PROCESS | 1669 | __startTimestamp1457461743758__endTimestamp 10:29:03 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | ------- Summary: start ------- 10:29:03 INFO - PROCESS | 1669 | Number of tests: 6 10:29:03 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | [#0] dojo.html Cycles:165 Average:5630.28 Median:5839.27 stddev:650.31 (11.1%) stddev-sans-first:628.42 10:29:03 INFO - PROCESS | 1669 | Values: 3404.2 3429.0 3471.9 3496.5 3517.3 5551.8 5597.3 5610.2 5611.7 5617.5 5461.6 5465.4 5480.8 5499.6 5500.3 5005.2 5017.4 5039.2 5096.1 5099.2 5065.3 5103.8 5108.6 5110.5 5119.2 4986.6 5031.5 5036.7 5077.6 5096.7 4842.8 5114.4 5151.4 5172.0 5213.6 5009.8 5030.6 5082.9 5092.6 5127.1 5461.3 5485.5 5508.2 5541.4 5600.8 6164.6 6177.8 6186.1 6207.0 6208.1 4990.9 6078.6 6206.2 6255.3 6259.0 5725.7 5726.7 5734.0 5744.1 5746.1 6234.4 6273.0 6274.4 6293.1 6296.9 5991.8 6040.8 6104.3 6114.7 6143.5 6146.9 6187.2 6202.3 6204.8 6229.9 6144.4 6149.8 6150.4 6157.1 6161.0 6067.6 6111.8 6111.9 6186.6 6193.4 4108.7 4835.5 4853.2 4878.9 4880.9 4345.3 4365.8 4374.9 4389.3 4434.3 5470.2 5497.6 5574.2 5575.0 5576.3 6129.8 6131.7 6256.0 6267.0 6280.7 4666.4 5523.3 5574.4 5588.6 5589.6 5202.2 5293.6 5295.7 5302.7 5351.9 5347.3 6174.9 6222.4 6250.5 6254.0 6181.4 6199.9 6229.9 6236.4 6239.2 6188.7 6205.4 6257.2 6308.7 6317.2 6109.6 6120.8 6140.5 6142.5 6162.1 6156.8 6221.7 6230.2 6239.4 6245.6 5865.2 5896.2 5961.2 6012.2 6036.7 6038.4 6045.6 6045.7 6064.2 6079.4 4972.0 5780.0 5852.5 5868.9 5875.0 4972.7 5846.1 5913.5 5952.3 6082.4 5793.3 5796.3 5839.3 5842.0 5843.7 10:29:03 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | [#1] ext.html Cycles:180 Average:60129.35 Median:36459.55 stddev:121508.12 (333.3%) stddev-sans-first:121766.50 10:29:03 INFO - PROCESS | 1669 | Values: 498.6 583.7 584.7 606.5 632.9 30503.5 30858.7 30875.7 30907.7 39173.6 42884.8 43232.0 43329.1 43358.8 43437.8 9547.6 9798.5 9802.4 9805.6 9820.0 9585.7 9696.1 9703.6 9715.9 9725.9 9660.6 9905.6 9912.1 9912.5 9913.6 9809.8 9875.0 9880.3 9881.6 9882.6 9593.6 9729.8 9730.6 9736.4 9743.1 34304.0 42691.0 42774.0 42784.8 42855.4 3352.2 3396.4 3478.7 3778.8 3838.2 28898.0 29563.6 30612.4 30702.8 30768.8 2766.0 2778.6 2791.7 2849.7 2861.7 496607.5 499841.0 500991.0 501562.4 502567.0 69067.0 69902.0 70435.0 70461.6 70482.0 74307.0 74616.6 75000.6 76185.6 76472.2 17204.1 17429.2 17467.8 17495.2 17498.6 13153.5 13187.2 13192.7 13209.9 13215.1 21899.3 22527.3 22662.5 22701.4 22718.0 8638.9 9012.5 9425.4 9664.2 9680.9 885.6 973.3 986.4 996.5 1020.8 29504.0 29746.0 29781.0 30517.7 30621.5 1035.8 1110.9 1142.3 1149.6 1189.4 14978.3 15222.9 15228.5 15304.2 15638.5 528301.0 535791.0 536235.0 536717.0 539033.0 59556.4 61689.0 61785.7 61829.1 61961.7 1345.0 1359.9 1470.6 1474.5 1502.6 22006.3 28698.0 29104.9 29376.0 29804.7 47201.6 47472.0 48060.3 48065.0 48117.8 294768.0 296707.0 296904.0 297554.0 298157.0 27805.6 33503.2 33610.5 34681.5 35150.0 42464.8 42640.1 42661.4 42760.8 43086.8 33885.0 34856.3 34866.8 35677.0 35745.3 31478.4 34687.7 35088.5 35663.6 35672.0 30476.4 34792.8 37173.8 37334.0 38072.9 28169.4 30467.9 31641.2 32460.0 32831.3 22696.9 24069.8 24418.8 24528.9 24918.1 10:29:03 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | [#2] jquery.html Cycles:180 Average:34548.74 Median:2425.95 stddev:104793.99 (4319.7%) stddev-sans-first:105056.43 10:29:03 INFO - PROCESS | 1669 | Values: 313.6 367.5 369.7 374.1 377.1 19654.6 19828.0 20444.0 20445.6 20470.9 19512.8 20305.6 20884.7 20895.9 20899.1 5920.6 6037.0 6049.1 6097.0 6121.0 4282.1 4572.0 6035.6 6709.7 6731.0 6634.0 6641.6 6642.8 6645.4 6648.1 5540.7 5781.4 5792.0 5800.2 6611.4 3755.8 5400.3 5530.8 5615.9 5630.1 12743.2 12784.6 12795.0 12959.4 12986.9 1832.6 2282.2 2320.3 2348.3 2503.6 9517.4 9581.3 9671.9 9954.2 9967.7 1730.7 1776.7 1807.5 1811.1 1834.6 77429.0 103425.4 113628.0 113840.0 116187.0 11063.9 11235.5 11258.3 11258.8 11358.3 13743.2 13799.1 13801.0 13814.2 13856.9 7001.7 7071.0 8547.5 8624.4 8740.2 8813.0 8820.6 8857.8 8917.5 8925.4 4392.2 4467.4 4484.8 4528.7 4562.5 1618.7 1649.4 1848.5 1894.4 1899.6 895.4 920.4 987.0 994.0 1007.4 19198.0 19585.7 19784.9 19807.6 19980.1 972.8 974.4 992.5 997.3 1014.9 10366.3 10693.6 10704.8 10716.8 10921.3 551903.2 631178.0 648720.0 661570.0 661720.0 114092.0 117339.4 117378.0 120005.0 121561.0 868.4 974.7 1066.7 1080.8 1084.7 16053.9 17403.9 17657.3 17710.6 17726.1 35943.0 50414.5 50844.0 50948.7 50966.0 72234.0 72835.0 72986.6 75164.6 75278.0 7644.2 7887.9 8070.4 8084.6 8092.7 7821.1 11325.6 12708.9 12763.9 13569.9 11188.5 11276.8 11297.5 11390.5 11537.0 10935.7 10966.2 10999.8 11140.6 11188.4 11258.3 11412.7 11534.1 11682.0 11731.2 7747.5 7968.2 8018.7 8060.1 8197.3 9507.8 10739.7 10798.0 11419.5 11640.7 10:29:03 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | [#3] mootools.html Cycles:180 Average:6061.11 Median:5461.69 stddev:3206.20 (58.7%) stddev-sans-first:3196.30 10:29:03 INFO - PROCESS | 1669 | Values: 1430.8 1567.4 1594.3 1878.2 2025.7 8037.0 8671.3 8846.5 8856.5 8857.7 8649.9 8655.7 8762.1 8762.2 8783.5 2172.7 2450.6 2483.4 2488.8 2490.1 2156.7 2457.9 2519.9 2521.0 2521.2 2384.8 2427.8 2437.0 2438.9 2448.6 2432.9 2451.7 2452.9 2456.9 2462.5 2475.9 2483.0 2486.0 2487.8 2495.2 8871.9 8918.4 8918.9 8921.3 8935.2 5305.9 5552.6 5552.8 5558.0 5568.0 3460.7 3484.8 3486.2 3531.0 3553.6 1003.8 1621.3 1662.6 1679.7 1683.1 11922.4 12006.3 12044.5 12051.8 12055.6 4665.7 4713.6 4729.3 4790.0 4792.8 9440.2 9489.2 9491.1 9495.6 9501.5 5412.3 5455.6 5459.8 5463.6 5465.6 4506.3 4602.1 4831.1 5022.3 5026.1 3268.5 3705.8 3749.0 3775.8 3778.9 1150.1 1160.2 1165.1 1166.4 1180.6 1213.8 1378.2 1420.4 1420.5 1421.7 8057.2 8334.5 8338.5 8341.3 8352.8 503.4 512.4 521.3 523.4 524.6 6340.3 6348.3 6437.3 6448.9 6449.5 10397.6 10705.9 10713.7 10747.3 10881.9 10402.3 10576.5 10702.8 10704.2 10712.5 8380.7 8469.2 8487.6 8549.4 8551.8 7828.3 8077.8 8092.8 8094.4 8099.9 9323.5 9546.6 9622.8 9757.5 9834.7 9666.5 9945.7 9947.6 10074.3 10077.9 6367.6 6833.9 6985.9 7054.0 7178.6 8409.3 8424.3 8452.7 8460.7 8466.3 7398.5 7503.3 7544.1 7564.1 7627.4 7213.4 7219.1 7252.5 7321.1 7345.4 7904.6 7914.8 7934.8 7946.6 7947.4 6703.4 6901.5 7102.3 7147.5 7159.9 7079.9 7085.6 7125.4 7135.8 7157.5 10:29:03 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | [#4] prototype.html Cycles:180 Average:5726.96 Median:6604.05 stddev:1858.26 (28.1%) stddev-sans-first:1818.72 10:29:03 INFO - PROCESS | 1669 | Values: 326.2 327.7 334.8 335.2 337.7 6441.5 6599.6 6613.4 6614.7 6647.7 6581.3 6608.5 6609.7 6612.2 6617.9 4682.6 4737.2 4784.9 4853.4 4915.8 4817.2 4836.4 4848.8 4853.0 4871.8 4800.0 4804.8 4808.7 4814.7 4816.8 4670.2 4687.9 4784.5 4794.1 4813.1 3382.9 4096.9 4119.1 4122.6 4130.6 6335.2 6337.1 6339.0 6344.4 6365.4 4413.8 5684.5 5726.8 5729.9 5734.3 5361.3 5703.7 7016.8 7023.4 7036.2 4265.3 4392.6 4402.6 4404.3 4409.2 7216.7 7334.0 7443.3 7443.9 7461.0 4588.0 4590.5 4590.9 4592.8 4596.6 4647.9 4653.6 4656.2 4661.5 4676.0 5580.5 5581.1 5585.1 5596.6 5596.7 6736.2 7033.2 7072.4 7075.7 7133.6 1610.3 1619.3 1627.0 1629.8 1630.9 832.0 967.2 1023.1 1032.7 1061.5 6342.9 6544.6 6582.1 6709.5 6717.2 7364.7 7382.7 7384.8 7399.6 7412.0 5385.4 5516.3 6706.9 6712.6 6716.2 3847.3 3882.9 3889.2 3891.6 3892.1 6569.9 7381.9 7426.6 7645.4 7645.5 7458.9 7531.0 7531.6 7535.0 7608.5 7680.2 7697.5 7697.8 7703.5 7712.6 7124.0 7248.6 7369.1 7376.5 7380.7 7177.5 7231.7 7235.2 7249.9 7254.7 7650.0 7665.8 7693.8 7700.0 7702.2 4585.6 4625.4 4635.5 4641.2 4649.5 6991.2 7333.5 7334.2 7338.6 7347.6 6098.9 6774.3 7034.3 7036.3 7107.6 7084.5 7088.5 7090.9 7090.9 7092.8 5645.6 6897.6 6907.2 6908.6 6923.2 6772.6 6982.9 7080.7 7094.4 7096.0 6617.2 6701.4 6724.3 6812.3 6883.4 10:29:03 INFO - PROCESS | 1669 | 10:29:03 INFO - PROCESS | 1669 | [#5] yui.html Cycles:180 Average:18155.24 Median:566.46 stddev:25686.05 (4534.5%) stddev-sans-first:25724.74 10:29:03 INFO - PROCESS | 1669 | Values: 718.8 757.9 780.0 783.8 790.8 15169.0 15315.0 15319.8 15330.2 15332.8 14040.9 14125.8 14150.4 14151.9 14170.4 770.4 779.9 918.8 939.2 962.7 945.3 952.7 952.8 955.7 957.0 1012.2 1012.9 1017.2 1017.9 1018.5 799.8 988.6 1006.6 1012.1 1012.8 752.5 753.8 754.3 755.7 757.6 15090.2 15148.5 15167.8 15180.7 15196.2 10785.8 12650.1 12732.9 12907.4 12989.2 10029.8 10039.2 10087.2 10159.5 10945.9 3591.6 3619.3 3623.3 3702.3 3716.2 83288.6 83711.6 83835.0 84150.6 84284.0 8111.4 9823.5 9903.0 10098.9 10679.8 18481.9 22053.2 22329.0 22361.8 22369.0 7619.0 7619.4 7650.3 7756.0 7824.8 4067.1 4117.3 4121.6 4124.9 4128.5 3412.4 3446.2 3453.5 3464.9 3467.8 575.5 625.3 625.6 636.9 685.7 518.5 580.6 591.6 627.8 646.8 7687.8 8201.6 8260.3 8325.0 8512.4 552.0 557.4 583.6 628.8 639.8 3766.9 3848.9 3852.8 3970.2 4139.6 87697.8 91963.5 93696.0 93964.0 94139.5 79901.6 80904.0 81063.0 81683.0 81880.0 68608.0 69235.0 69838.7 69859.7 71081.0 7771.9 7778.2 7789.7 7833.7 7920.4 31404.7 44582.4 44955.1 45267.0 45586.8 60967.0 62877.0 64707.0 65577.7 65893.0 9166.0 9439.0 10734.0 11262.6 11694.0 12113.6 12305.7 12381.7 12436.9 12624.6 11657.5 11693.4 11749.8 11788.7 11865.3 11534.7 11567.2 11877.4 11897.7 11945.8 9157.7 11244.4 11300.7 11551.3 11576.7 9771.3 9790.8 9942.8 9961.4 10060.4 6986.0 8462.2 8852.2 8966.3 9652.1 10:29:03 INFO - PROCESS | 1669 | -------- Summary: end -------- 10:29:03 INFO - PROCESS | 1669 | 10:29:04 INFO - TEST-INFO | 1669: exit 0 10:29:04 INFO - TEST-OK | dromaeo_css | took 1113332ms 10:29:04 INFO - TEST-START | kraken 10:29:04 INFO - operating with platform_type : mac_ 10:29:04 INFO - Initialising browser for kraken test... 10:29:04 INFO - TEST-INFO | started process 1674 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/tmpahB3Pr/profile http://localhost:49271/getInfo.html) 10:29:06 INFO - PROCESS | 1674 | __metrics Screen width/height:1600/1200 10:29:06 INFO - PROCESS | 1674 | colorDepth:24 10:29:06 INFO - PROCESS | 1674 | Browser inner width/height: 1024/689 10:29:06 INFO - PROCESS | 1674 | __metrics 10:29:06 INFO - PROCESS | 1674 | 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" 10:29:06 INFO - PROCESS | 1674 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:29:07 INFO - TEST-INFO | 1674: exit 0 10:29:07 INFO - Browser initialized. 10:29:07 INFO - Running cycle 1/1 for kraken test... 10:29:07 INFO - TEST-INFO | started process 1676 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/T/tmpahB3Pr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:29:19 INFO - PROCESS | 1676 | RSS: Main: 245940224 10:29:19 INFO - PROCESS | 1676 | 10:29:21 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-beat-detection) 10:29:22 INFO - PROCESS | 1676 | RSS: Main: 291000320 10:29:22 INFO - PROCESS | 1676 | 10:29:25 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-dft) 10:29:25 INFO - PROCESS | 1676 | RSS: Main: 301776896 10:29:25 INFO - PROCESS | 1676 | 10:29:28 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-fft) 10:29:29 INFO - PROCESS | 1676 | RSS: Main: 284958720 10:29:29 INFO - PROCESS | 1676 | 10:29:31 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-oscillator) 10:29:31 INFO - PROCESS | 1676 | RSS: Main: 287739904 10:29:31 INFO - PROCESS | 1676 | 10:29:34 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:29:34 INFO - PROCESS | 1676 | RSS: Main: 289087488 10:29:34 INFO - PROCESS | 1676 | 10:29:37 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-darkroom) 10:29:37 INFO - PROCESS | 1676 | RSS: Main: 290754560 10:29:37 INFO - PROCESS | 1676 | 10:29:40 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-desaturate) 10:29:41 INFO - PROCESS | 1676 | RSS: Main: 289677312 10:29:41 INFO - PROCESS | 1676 | 10:29:44 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49271/tests/kraken/driver.html?testName=json-parse-financial) 10:29:44 INFO - PROCESS | 1676 | RSS: Main: 291688448 10:29:44 INFO - PROCESS | 1676 | 10:29:46 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49271/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:29:46 INFO - PROCESS | 1676 | RSS: Main: 325111808 10:29:46 INFO - PROCESS | 1676 | 10:29:48 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:29:49 INFO - PROCESS | 1676 | RSS: Main: 322936832 10:29:49 INFO - PROCESS | 1676 | 10:29:51 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:29:51 INFO - PROCESS | 1676 | RSS: Main: 332951552 10:29:51 INFO - PROCESS | 1676 | 10:29:54 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:29:55 INFO - PROCESS | 1676 | RSS: Main: 335224832 10:29:55 INFO - PROCESS | 1676 | 10:29:57 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:29:58 INFO - PROCESS | 1676 | RSS: Main: 334352384 10:29:58 INFO - PROCESS | 1676 | 10:29:59 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49271/tests/kraken/driver.html?testName=ai-astar) 10:30:00 INFO - PROCESS | 1676 | RSS: Main: 394473472 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | __start_tp_report 10:30:00 INFO - PROCESS | 1676 | _x_x_mozilla_page_load 10:30:00 INFO - PROCESS | 1676 | _x_x_mozilla_page_load_details 10:30:00 INFO - PROCESS | 1676 | |i|pagename|runs| 10:30:00 INFO - PROCESS | 1676 | |0;ai-astar;111;109;110;109;111;110;116;109;110;110 10:30:00 INFO - PROCESS | 1676 | |1;audio-beat-detection;165;153;174;156;117;139;138;118;159;116 10:30:00 INFO - PROCESS | 1676 | |2;audio-dft;189;204;184;184;185;182;184;179;180;182 10:30:00 INFO - PROCESS | 1676 | |3;audio-fft;77;74;88;78;56;58;57;81;94;55 10:30:00 INFO - PROCESS | 1676 | |4;audio-oscillator;90;103;130;80;78;88;115;76;80;115 10:30:00 INFO - PROCESS | 1676 | |5;imaging-gaussian-blur;87;84;87;85;86;85;87;84;87;84 10:30:00 INFO - PROCESS | 1676 | |6;imaging-darkroom;92;93;93;93;92;93;93;111;151;120 10:30:00 INFO - PROCESS | 1676 | |7;imaging-desaturate;87;89;88;89;88;87;90;90;88;85 10:30:00 INFO - PROCESS | 1676 | |8;json-parse-financial;55;53;54;52;55;53;54;63;53;51 10:30:00 INFO - PROCESS | 1676 | |9;json-stringify-tinderbox;64;70;72;77;70;67;66;66;66;68 10:30:00 INFO - PROCESS | 1676 | |10;stanford-crypto-aes;83;82;80;83;85;82;80;81;83;84 10:30:00 INFO - PROCESS | 1676 | |11;stanford-crypto-ccm;131;125;119;132;128;124;118;122;108;153 10:30:00 INFO - PROCESS | 1676 | |12;stanford-crypto-pbkdf2;139;126;137;138;135;126;138;137;138;135 10:30:00 INFO - PROCESS | 1676 | |13;stanford-crypto-sha256-iterative;69;66;65;67;65;68;68;68;64;94 10:30:00 INFO - PROCESS | 1676 | __end_tp_report 10:30:00 INFO - PROCESS | 1676 | __start_cc_report 10:30:00 INFO - PROCESS | 1676 | _x_x_mozilla_cycle_collect,1239 10:30:00 INFO - PROCESS | 1676 | __end_cc_report 10:30:00 INFO - PROCESS | 1676 | __startTimestamp1457461800135__endTimestamp 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | ------- Summary: start ------- 10:30:00 INFO - PROCESS | 1676 | Number of tests: 14 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#0] ai-astar Cycles:10 Average:110.50 Median:110.00 stddev:2.07 (1.9%) stddev-sans-first:2.19 10:30:00 INFO - PROCESS | 1676 | Values: 111.0 109.0 110.0 109.0 111.0 110.0 116.0 109.0 110.0 110.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#1] audio-beat-detection Cycles:10 Average:143.50 Median:154.50 stddev:21.18 (13.7%) stddev-sans-first:20.99 10:30:00 INFO - PROCESS | 1676 | Values: 165.0 153.0 174.0 156.0 117.0 139.0 138.0 118.0 159.0 116.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#2] audio-dft Cycles:10 Average:185.30 Median:184.00 stddev:7.13 (3.9%) stddev-sans-first:7.44 10:30:00 INFO - PROCESS | 1676 | Values: 189.0 204.0 184.0 184.0 185.0 182.0 184.0 179.0 180.0 182.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#3] audio-fft Cycles:10 Average:71.80 Median:77.50 stddev:14.34 (18.5%) stddev-sans-first:15.09 10:30:00 INFO - PROCESS | 1676 | Values: 77.0 74.0 88.0 78.0 56.0 58.0 57.0 81.0 94.0 55.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#4] audio-oscillator Cycles:10 Average:95.50 Median:79.00 stddev:19.03 (24.1%) stddev-sans-first:20.08 10:30:00 INFO - PROCESS | 1676 | Values: 90.0 103.0 130.0 80.0 78.0 88.0 115.0 76.0 80.0 115.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#5] imaging-gaussian-blur Cycles:10 Average:85.60 Median:86.50 stddev:1.35 (1.6%) stddev-sans-first:1.33 10:30:00 INFO - PROCESS | 1676 | Values: 87.0 84.0 87.0 85.0 86.0 85.0 87.0 84.0 87.0 84.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#6] imaging-darkroom Cycles:10 Average:103.10 Median:93.00 stddev:19.43 (20.9%) stddev-sans-first:20.19 10:30:00 INFO - PROCESS | 1676 | Values: 92.0 93.0 93.0 93.0 92.0 93.0 93.0 111.0 151.0 120.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#7] imaging-desaturate Cycles:10 Average:88.10 Median:88.50 stddev:1.52 (1.7%) stddev-sans-first:1.56 10:30:00 INFO - PROCESS | 1676 | Values: 87.0 89.0 88.0 89.0 88.0 87.0 90.0 90.0 88.0 85.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#8] json-parse-financial Cycles:10 Average:54.30 Median:54.00 stddev:3.30 (6.1%) stddev-sans-first:3.49 10:30:00 INFO - PROCESS | 1676 | Values: 55.0 53.0 54.0 52.0 55.0 53.0 54.0 63.0 53.0 51.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#9] json-stringify-tinderbox Cycles:10 Average:68.60 Median:69.00 stddev:3.81 (5.5%) stddev-sans-first:3.66 10:30:00 INFO - PROCESS | 1676 | Values: 64.0 70.0 72.0 77.0 70.0 67.0 66.0 66.0 66.0 68.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#10] stanford-crypto-aes Cycles:10 Average:82.30 Median:83.00 stddev:1.64 (2.0%) stddev-sans-first:1.72 10:30:00 INFO - PROCESS | 1676 | Values: 83.0 82.0 80.0 83.0 85.0 82.0 80.0 81.0 83.0 84.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#11] stanford-crypto-ccm Cycles:10 Average:126.00 Median:126.50 stddev:11.79 (9.3%) stddev-sans-first:12.37 10:30:00 INFO - PROCESS | 1676 | Values: 131.0 125.0 119.0 132.0 128.0 124.0 118.0 122.0 108.0 153.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:134.90 Median:137.50 stddev:4.86 (3.5%) stddev-sans-first:4.93 10:30:00 INFO - PROCESS | 1676 | Values: 139.0 126.0 137.0 138.0 135.0 126.0 138.0 137.0 138.0 135.0 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - PROCESS | 1676 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.40 Median:68.00 stddev:8.80 (12.9%) stddev-sans-first:9.33 10:30:00 INFO - PROCESS | 1676 | Values: 69.0 66.0 65.0 67.0 65.0 68.0 68.0 68.0 64.0 94.0 10:30:00 INFO - PROCESS | 1676 | -------- Summary: end -------- 10:30:00 INFO - PROCESS | 1676 | 10:30:00 INFO - TEST-INFO | 1676: exit 0 10:30:00 INFO - TEST-OK | kraken | took 56583ms 10:30:00 INFO - SUITE-END | took 1169s 10:30:01 INFO - Completed test suite (00:19:30) 10:30:01 INFO - javascript benchmark 10:30:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3404.2340473393488, 3428.982855085723, 3471.913202169944, 3496.4930085137657, 3517.3317069756745, 5551.805686800963, 5597.328320601523, 5610.186522954169, 5611.719414029298, 5617.466340697632, 5461.617686761928, 5465.398806131322, 5480.835574932748, 5499.560035197184, 5500.312460942382, 5005.199168133099, 5017.37282839645, 5039.168537191359, 5096.082705113078, 5099.235114732783, 5065.341505604285, 5103.821366252182, 5108.6168537359845, 5110.463401342861, 5119.1809310510325, 4986.551210391064, 5031.547160755531, 5036.6726162799305, 5077.59379249661, 5096.668716533432, 4842.757862106916, 5114.360704911886, 5151.381834179885, 5172.0, 5213.556847667934, 5009.799608015675, 5030.647854650176, 5082.898342033176, 5092.6180536459915, 5127.128388174019, 5461.262729531502, 5485.533729632986, 5508.173773933902, 5541.445855414467, 5600.803971860965, 6164.630122192638, 6177.752889884399, 6186.103015062836, 6206.975848984957, 6208.099825525319, 4990.87522811929, 6078.635281883101, 6206.162168107293, 6255.280642726099, 6259.0, 5725.742341594639, 5726.742296596663, 5733.996550603628, 5744.080947048494, 5746.080627099644, 6234.37656234382, 6273.0, 6274.372562743781, 6293.118963345044, 6296.874062518724, 5991.760329586855, 6040.758369665252, 6104.26748790148, 6114.694265286718, 6143.477804386677, 6146.938530614637, 6187.226596675416, 6202.317745048041, 6204.782832600928, 6229.906551401733, 6144.446999770043, 6149.815505534841, 6150.446459818638, 6157.138000679908, 6160.983437732813, 6067.605605635619, 6111.804454079507, 6111.865232675468, 6186.628802271788, 6193.38066193377, 4108.712390132662, 4835.516448355207, 4853.247746599282, 4878.8780280492565, 4880.853574392774, 4345.261305578059, 4365.825366985348, 4374.868753937387, 4389.253826849444, 4434.290513517822, 5470.17947307907, 5497.5601951843755, 5574.219609254707, 5574.9721251393485, 5576.33084029919, 6129.756146212572, 6131.651934473265, 6256.0303153011355, 6267.0286105653695, 6280.654563998933, 4666.416697912761, 5523.337199536001, 5574.414686457863, 5588.580856435784, 5589.552835773128, 5202.167653175549, 5293.629445938747, 5295.708736019479, 5302.655327403783, 5351.919721204185, 5347.304850369427, 6174.9073763893575, 6222.408871157233, 6250.531210159165, 6253.96873015632, 6181.350958149509, 6199.907001395073, 6229.875402492015, 6236.407541283571, 6239.220097487814, 6188.721507532082, 6205.410486003822, 6257.217847769029, 6308.71610777507, 6317.210348706411, 6109.586862300737, 6120.816375508742, 6140.478059365004, 6142.539309551891, 6162.075688646739, 6156.846078848064, 6221.688915554295, 6230.221222347207, 6239.376062393724, 6245.5628106033955, 5865.192996754751, 5896.204012458435, 5961.195238642727, 6012.188354572252, 6036.6679832609625, 6038.365971572922, 6045.6070355426755, 6045.727942242697, 6064.241969753781, 6079.392060793885, 4972.005598880311, 5779.971100144472, 5852.502537284378, 5868.94131058701, 5874.970625146847, 4972.701637901738, 5846.123081537803, 5913.497352725067, 5952.315483719254, 6082.422169893853, 5793.333766616893, 5796.333421656394, 5839.270091238595, 5841.977653910463, 5843.707814609337], "unit": "score", "name": "dojo.html", "value": 5590.277074665292}, {"lowerIsBetter": false, "replicates": [498.6235392278829, 583.667309633509, 584.6608966799254, 606.4511616986628, 632.8576070384163, 30503.54244686329, 30858.691413085864, 30875.69124308759, 30907.690923090762, 39173.608263917355, 42884.78557607208, 43232.0, 43329.133417331635, 43358.783206084, 43437.7828110859, 9547.61809527618, 9798.461084640341, 9802.41185528867, 9805.558749856273, 9820.0, 9585.66450174244, 9696.078872507136, 9703.563339649698, 9715.854262186072, 9725.854112188323, 9660.613575457008, 9905.603775848957, 9912.05835445635, 9912.504374781232, 9913.603455861758, 9809.803803923953, 9875.0, 9880.258980576486, 9881.555330010167, 9882.555285012191, 9593.616255349847, 9729.805403891953, 9730.562124704406, 9736.367136136128, 9743.074407931306, 34304.0, 42691.01162918597, 42774.0, 42784.78607606973, 42855.35716964248, 3352.2457447074457, 3396.3716712408036, 3478.704310133616, 3778.754380965256, 3838.1556057667267, 28897.988570399935, 29563.556546651816, 30612.387752245053, 30702.84648576765, 30768.84615576908, 2766.0, 2778.597103419993, 2791.6929137794828, 2849.700781417963, 2861.699521550228, 496607.51696241647, 499841.0, 500991.0, 501562.4453144159, 502567.0, 69066.9639955401, 69901.95147072797, 70435.0, 70461.64769176223, 70482.0, 74307.0, 74616.62691686506, 75000.62499687467, 76185.6190719054, 76472.23527764762, 17204.053777042132, 17429.21568529419, 17467.82532174662, 17495.212715427835, 17498.56253593645, 13153.539626113232, 13187.208767473981, 13192.670183245496, 13209.867901320864, 13215.074944753775, 21899.343019709435, 22527.31045171619, 22662.546749064928, 22701.43246418853, 22717.977691003944, 8638.913610863936, 9012.549372531346, 9425.434473931586, 9664.226861851035, 9680.903190968, 885.5616469847466, 973.3478569358405, 986.413084214891, 996.4718699089494, 1020.831562792131, 29504.0, 29746.0, 29781.0, 30517.694823051486, 30621.540676889865, 1035.7777822169912, 1110.8889111088988, 1142.3150852492672, 1149.6206251937008, 1189.3993533265646, 14978.325975331136, 15222.923885380502, 15228.46700365504, 15304.158271295186, 15638.45265415705, 528301.0, 535791.0, 536235.0, 536717.0, 539033.0, 59556.40443595508, 61689.0, 61785.69107154435, 61829.07256391158, 61961.690191548754, 1344.9663758406118, 1359.9252041137831, 1470.5882352941194, 1474.4839306242943, 1502.6393665520197, 22006.339809805733, 28698.0, 29104.854475727487, 29376.0, 29804.70195298019, 47201.58395248148, 47472.0, 48060.27909581289, 48065.03869922512, 48117.75941120412, 294768.0, 296707.0, 296904.0, 297554.0, 298157.0, 27805.582916256677, 33503.16242093967, 33610.49584256287, 34681.47977780285, 35150.0, 42464.78767606142, 42640.1471970565, 42661.36007959821, 42760.78619606882, 43086.78456607697, 33885.0, 34856.30287394187, 34866.82566587151, 35677.0, 35745.28509429745, 31478.426078696433, 34687.65312346945, 35088.47367289544, 35663.64336356603, 35672.0, 30476.390472190877, 34792.82603586966, 37173.814130929175, 37334.0, 38072.85781426562, 28169.43661126807, 30467.93362232311, 31641.16241761477, 32460.0, 32831.343373131924, 22696.886515567316, 24069.759302407452, 24418.755812441646, 24528.87735561311, 24918.12786552462], "unit": "score", "name": "ext.html", "value": 19808.206574179996}, {"lowerIsBetter": false, "replicates": [313.5938959048033, 367.5057048270076, 369.67653303359543, 374.1021548284119, 377.1194261399632, 19654.606907861835, 19828.008599570017, 20444.0, 20445.59108817823, 20470.87410192439, 19512.804871951277, 20305.60373482352, 20884.686729699068, 20895.895520522416, 20899.133660272822, 5920.585559010871, 6037.0, 6049.1228771828055, 6097.0, 6120.969395153018, 4282.122164956177, 4571.954280457203, 6035.6076855004285, 6709.6980635871505, 6730.966345168292, 6634.0, 6641.601503909781, 6642.800715978528, 6645.43513801325, 6648.135742353512, 5540.695261760601, 5781.392953739839, 5792.044312688401, 5800.187973683687, 6611.371919667624, 3755.8497660093562, 5400.270963419966, 5530.834074977717, 5615.859603509904, 5630.127330263816, 12743.235405875677, 12784.61646150617, 12795.0, 12959.352032398436, 12986.935065324707, 1832.5968286976845, 2282.2468585366955, 2320.33870346952, 2348.3189874936247, 2503.574392353304, 9517.381370210915, 9581.329306948517, 9671.90328096724, 9954.203663706887, 9967.70096897087, 1730.731736580832, 1776.671315806567, 1807.493901707524, 1811.148760082759, 1834.642244762272, 77429.0, 103425.44861827079, 113628.0, 113840.0, 116187.0, 11063.944680276709, 11235.494402751896, 11258.324500529994, 11258.831117533244, 11358.26171298863, 13743.175409475463, 13799.103058301178, 13801.0, 13814.171149731048, 13856.93071534636, 7001.684924178424, 7070.964645176741, 8547.487150770974, 8624.396292259482, 8740.21338079576, 8813.0, 8820.647174113092, 8857.822843543094, 8917.509536975398, 8925.419847709878, 4392.1874453226255, 4467.396901418267, 4484.798184081724, 4528.705634133771, 4562.520935301745, 1618.6681730245507, 1649.4144578674398, 1848.5471059590218, 1894.4032629721594, 1899.620075984781, 895.4492986813193, 920.3985065985138, 987.0327079462168, 993.9850902236473, 1007.3905287301224, 19198.040097995043, 19585.706214406797, 19784.90107549453, 19807.60384792296, 19980.10089545974, 972.8297547929226, 974.3520558828442, 992.4938281476354, 997.3118548201718, 1014.9188064954934, 10366.274360794823, 10693.625723099654, 10704.839427408595, 10716.839247411295, 10921.290116142425, 551903.2404838031, 631178.0, 648720.0, 661570.0, 661720.0, 114092.0, 117339.41330293294, 117378.0, 120005.0, 121561.0, 868.3877866104381, 974.741693451236, 1066.7279843639822, 1080.8432777247256, 1084.7017070305728, 16053.919730401274, 17403.912980435016, 17657.293708251527, 17710.557236069202, 17726.10025794323, 35943.0, 50414.49585504098, 50844.0, 50948.74525627348, 50966.0, 72234.0, 72835.0, 72986.63506682432, 75164.62417687876, 75278.0, 7644.235576442311, 7887.921120788948, 8070.435069545076, 8084.555349455602, 8092.6762929482165, 7821.1005734339005, 11325.603603873826, 12708.87291127077, 12763.872361276268, 13569.93215033958, 11188.496517656888, 11276.830847537129, 11297.548098075986, 11390.487428065922, 11537.03870342027, 10935.671929842118, 10966.232363734462, 10999.835002475129, 11140.610078647209, 11188.440577971232, 11258.324500529994, 11412.657620271406, 11534.134939879375, 11682.0, 11731.23746956445, 7747.496412733154, 7968.16334284915, 8018.719344822904, 8060.11338752725, 8197.262246397853, 9507.809843802946, 10739.731506712395, 10798.028177464066, 11419.486123124314, 11640.708982275512], "unit": "score", "name": "jquery.html", "value": 9211.921204855047}, {"lowerIsBetter": false, "replicates": [1430.8283006039264, 1567.4357231396696, 1594.2666373468205, 1878.2299257304498, 2025.7062725904743, 8036.959815200923, 8671.262942649875, 8846.5134417607, 8856.468611883292, 8857.689980850664, 8649.870251946226, 8655.740327790176, 8762.12378762125, 8762.21140097391, 8783.516906570136, 2172.728408948881, 2450.595651717469, 2483.379155211197, 2488.8008959283306, 2490.1160088168713, 2156.6657168138886, 2457.8771061446946, 2519.924402267935, 2520.962185567218, 2521.1680145552014, 2384.833061685683, 2427.7693619106158, 2436.9634455483183, 2438.878056097197, 2448.6204638281097, 2432.8661923594195, 2451.6567680524563, 2452.901883924641, 2456.852588844666, 2462.54442928058, 2475.8762061897014, 2482.987585062081, 2485.968323145892, 2487.8134139939575, 2495.1765917247267, 8871.866921996176, 8918.42030268037, 8918.910810891874, 8921.330900182447, 8935.240504557121, 5305.8938821223355, 5552.639078459887, 5552.833414997556, 5557.972210138923, 5568.025595520768, 3460.723142148622, 3484.790912545255, 3486.2330287336745, 3531.0113168312914, 3553.626869178751, 1003.8393856982848, 1621.3433559408459, 1662.6342204714942, 1679.7144485437504, 1683.1163639089575, 11922.403879805976, 12006.279623222546, 12044.45799938996, 12051.758964820654, 12055.578054768128, 4665.650076244296, 4713.622910167179, 4729.290606409066, 4789.976050119727, 4792.7603619819565, 9440.24478041755, 9489.1934185595, 9491.098345657152, 9495.620175192915, 9501.477418741897, 5412.296401467784, 5455.645383050089, 5459.798844254257, 5463.590230732711, 5465.617406781566, 4506.3465797459185, 4602.05657840142, 4831.0820944020525, 5022.296878437021, 5026.145555255543, 3268.4770436730487, 3705.796181210005, 3749.025253434072, 3775.811209439572, 3778.905527361783, 1150.1201580790703, 1160.1762748448696, 1165.143619439711, 1166.3993043582561, 1180.6281021478208, 1213.7815193265296, 1378.179982910167, 1420.403430559147, 1420.4744244629553, 1421.7227640610188, 8057.153998830038, 8334.541600212047, 8338.541380224025, 8341.332693384515, 8352.83294334122, 503.4487236476053, 512.397932429394, 521.3379008659058, 523.4216191108846, 524.551508460261, 6340.3342649022115, 6348.301686814447, 6437.324080971524, 6448.871022579522, 6449.484041276686, 10397.63608273722, 10705.89294107049, 10713.732156696145, 10747.30142540748, 10881.891181088246, 10402.323848949794, 10576.4711764413, 10702.785944281226, 10704.19718521114, 10712.517936692868, 8380.706675266336, 8469.195426434479, 8487.575621218914, 8549.358798090168, 8551.828963420698, 7828.334591559781, 8077.7576672699915, 8092.797680058045, 8094.433389662667, 8099.87850182236, 9323.533823308942, 9546.57040433196, 9622.807543848943, 9757.512124393894, 9834.704958851245, 9666.516674166403, 9945.701628951143, 9947.552360143665, 10074.345167564084, 10077.899221007696, 6367.649779262185, 6833.940739185434, 6985.895211571932, 7054.047703559953, 7178.641067946477, 8409.285210756909, 8424.28393586552, 8452.74641760748, 8460.746177614681, 8466.322694184328, 7398.519096258726, 7503.287187717158, 7544.132424771002, 7564.130125035691, 7627.427942904415, 7213.350798428167, 7219.061522002106, 7252.4560657949805, 7321.121465424183, 7345.375643070185, 7904.604769761374, 7914.762557123296, 7934.841303173789, 7946.602669866599, 7947.443678942419, 6703.363180497845, 6901.516893817586, 7102.254263302279, 7147.463940204401, 7159.8568028640175, 7079.893801592877, 7085.6457177141965, 7125.35871771543, 7135.82160445993, 7157.498975071695], "unit": "score", "name": "mootools.html", "value": 4883.001735727043}, {"lowerIsBetter": false, "replicates": [326.15525788208544, 327.70670250126136, 334.7773730469238, 335.2373350627323, 337.6690842973887, 6441.549091563593, 6599.637019963906, 6613.437857782088, 6614.735410583571, 6647.667616619174, 6581.2760596334365, 6608.471322294217, 6609.669516524166, 6612.23959244687, 6617.90804517254, 4682.555157260055, 4737.170995075865, 4784.880377990561, 4853.39332583427, 4915.75421228938, 4817.22924332107, 4836.37127173467, 4848.781804818792, 4853.02939412119, 4871.780769865347, 4800.039992001596, 4804.759762011903, 4808.735519546423, 4814.662973591832, 4816.807327706905, 4670.2060649689465, 4687.859364219096, 4784.473707892129, 4794.089123066607, 4813.061453016663, 3382.915427114342, 4096.877093687164, 4119.0937993641355, 4122.628963393279, 4130.56629053948, 6335.176427064498, 6337.081123237151, 6338.968305158491, 6344.429001389897, 6365.363463653597, 4413.801378937924, 5684.459976302286, 5726.7995620153515, 5729.856753581152, 5734.311882574076, 5361.276227709248, 5703.686297253649, 7016.75441359555, 7023.367896889305, 7036.226015138331, 4265.253580623409, 4392.604665580081, 4402.581754733295, 4404.317330813729, 4409.1843009043105, 7216.67524961378, 7333.963330183368, 7443.2556744325675, 7443.851122977564, 7461.030066091427, 4587.954120458753, 4590.517995610479, 4590.862274131715, 4592.770361481913, 4596.5863072323655, 4647.907041859144, 4653.604443622262, 4656.185167595657, 4661.463931647836, 4675.976620116946, 5580.469855363734, 5581.10702287632, 5585.050541407971, 5596.636218645775, 5596.664200148004, 6736.157980252468, 7033.156021277479, 7072.434205263567, 7075.681594328267, 7133.5719856808755, 1610.3236640610971, 1619.2632352279684, 1626.9912654154264, 1629.7881275434117, 1630.8776841736917, 832.0, 967.2455484721928, 1023.125227930124, 1032.6747074671455, 1061.543536279392, 6342.889994250988, 6544.574602650812, 6582.111414959015, 6709.496787740939, 6717.16035495563, 7364.742234021784, 7382.74160404394, 7384.778456646309, 7399.556026638419, 7411.999380083727, 5385.434529374437, 5516.310461192351, 6706.899396509057, 6712.630805305755, 6716.194056713226, 3847.3459511883048, 3882.941755873664, 3889.241597888441, 3891.552471465761, 3892.143728379752, 6569.868602628017, 7381.926180738231, 7426.554406735613, 7645.350145237717, 7645.541267523967, 7458.85082298351, 7530.962345188349, 7531.623418829036, 7534.982777324991, 7608.505447145918, 7680.155182929873, 7697.538147711043, 7697.807554811175, 7703.460757747016, 7712.5758083305955, 7124.038254835531, 7248.56508609464, 7369.115706115301, 7376.520526165782, 7380.667869945973, 7177.533460325271, 7231.746888858865, 7235.2041275458605, 7249.891251631124, 7254.709811607477, 7650.0, 7665.770026899202, 7693.769186924401, 7699.961500192463, 7702.152763195932, 4585.564371384713, 4625.375574297427, 4635.536446355338, 4641.187792136295, 4649.465311489222, 6991.230964593992, 7333.523320984119, 7334.193238743627, 7338.596377199306, 7347.595882226315, 6098.878022439438, 6774.3225677431865, 7034.261402552863, 7036.331548502884, 7107.644617769194, 7084.504084714021, 7088.539244949062, 7090.858182836211, 7090.893636595352, 7092.787216383516, 5645.633033852787, 6897.620630865351, 6907.240203577703, 6908.620025898624, 6923.2038315594355, 6772.627505487246, 6982.895256571257, 7080.716771329089, 7094.417319253744, 7095.9645201773665, 6617.172853393326, 6701.396874281338, 6724.260331363644, 6812.318768123148, 6883.380495755406], "unit": "score", "name": "prototype.html", "value": 5102.922898488525}, {"lowerIsBetter": false, "replicates": [718.8490417012428, 757.8711619024768, 780.0171783552723, 783.8393129408472, 790.778581997041, 15169.0, 15315.0, 15319.846801531981, 15330.15684137372, 15332.770008449883, 14040.929795351009, 14125.78811317831, 14150.433982640681, 14151.93860460467, 14170.433182672681, 770.4298818874049, 779.8986131802858, 918.8254231695989, 939.2063706168294, 962.6823148361024, 945.2863088368273, 952.6618050592044, 952.7760976170595, 955.69895482923, 956.9569169605129, 1012.185190921308, 1012.8632634594309, 1017.2421545948242, 1017.9083882450578, 1018.4653057145022, 799.8360336131079, 988.5798535622367, 1006.6225165562914, 1012.0790081026231, 1012.7518757904287, 752.5259086775351, 753.7927070055724, 754.3474894216463, 755.6788364944877, 757.5946868425366, 15090.245487725679, 15148.545543633709, 15167.772483412758, 15180.696386072326, 15196.240187990667, 10785.78428431427, 12650.114491985565, 12732.936335318356, 12907.354632268443, 12989.155704879247, 10029.799404011952, 10039.196864250915, 10087.243456740774, 10159.4920253987, 10945.890541094566, 3591.6228795976567, 3619.312330657193, 3623.347797396494, 3702.2780557791243, 3716.163863130801, 83288.58355708243, 83711.58144209301, 83835.0, 84150.57924710338, 84284.0, 8111.432199746079, 9823.508824558743, 9902.950485247527, 10098.949505252574, 10679.83980240297, 18481.90759046196, 22053.22813701513, 22329.0, 22361.776382236294, 22369.0, 7619.0, 7619.390448764086, 7650.273224043707, 7755.961220193863, 7824.84350313002, 4067.1458993611673, 4117.3206420940205, 4121.567235440296, 4124.938125928114, 4128.504579450485, 3412.368711788327, 3446.190145315849, 3453.4977284881156, 3464.8960531184107, 3467.826608669556, 575.4763165519357, 625.337142628815, 625.587725810443, 636.8949123394588, 685.6982927511879, 518.4763388977085, 580.6281340723109, 591.6243185577104, 627.7614506487505, 646.8059582125344, 7687.769366919001, 8201.589920503951, 8260.339172866155, 8325.0, 8512.361572881935, 551.969641669704, 557.4342042826535, 583.5564970622357, 628.7799270255374, 639.8098397999338, 3766.868159614455, 3848.9230215395537, 3852.8266228019806, 3970.166265084307, 4139.606737359946, 87697.80755481165, 91963.54018229866, 93696.0, 93964.0, 94139.52930235305, 79901.60049199717, 80904.0, 81063.0, 81683.0, 81880.0, 68607.97088043683, 69235.0, 69838.65080674565, 69859.65070174719, 71081.0, 7771.8834217485655, 7778.222177782177, 7789.6884124636645, 7833.725819596287, 7920.445568810128, 31404.685953141092, 44582.43961461333, 44955.10089798251, 45267.0, 45586.772066139456, 60967.0, 62877.0, 64707.029394560064, 65577.67211163914, 65893.0, 9166.0, 9438.96171421157, 10733.971857867855, 11262.605808796652, 11694.0, 12113.576024839089, 12305.692357690772, 12381.690457738268, 12436.875631243935, 12624.55814046504, 11657.53369865196, 11693.415329233674, 11749.823752643888, 11788.705282367666, 11865.347405892759, 11534.711632208926, 11567.248128871597, 11877.406129693654, 11897.702557436134, 11945.761084778429, 9157.679481218393, 11244.437778111225, 11300.717482063013, 11551.306921584732, 11576.710582235512, 9771.267154963263, 9790.804183916423, 9942.751431214278, 9961.40231586107, 10060.39637621745, 6986.0, 8462.238398544161, 8852.24755895756, 8966.327525435749, 9652.131308182297], "unit": "score", "name": "yui.html", "value": 6926.842328637321}], "name": "dromaeo_css", "value": 7486.5929540797915}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 109.0, 110.0, 109.0, 111.0, 110.0, 116.0, 109.0, 110.0, 110.0], "unit": "score", "name": "ai-astar", "value": 110.5}, {"lowerIsBetter": true, "replicates": [165.0, 153.0, 174.0, 156.0, 117.0, 139.0, 138.0, 118.0, 159.0, 116.0], "unit": "score", "name": "audio-beat-detection", "value": 143.5}, {"lowerIsBetter": true, "replicates": [189.0, 204.0, 184.0, 184.0, 185.0, 182.0, 184.0, 179.0, 180.0, 182.0], "unit": "score", "name": "audio-dft", "value": 185.3}, {"lowerIsBetter": true, "replicates": [77.0, 74.0, 88.0, 78.0, 56.0, 58.0, 57.0, 81.0, 94.0, 55.0], "unit": "score", "name": "audio-fft", "value": 71.8}, {"lowerIsBetter": true, "replicates": [90.0, 103.0, 130.0, 80.0, 78.0, 88.0, 115.0, 76.0, 80.0, 115.0], "unit": "score", "name": "audio-oscillator", "value": 95.5}, {"lowerIsBetter": true, "replicates": [87.0, 84.0, 87.0, 85.0, 86.0, 85.0, 87.0, 84.0, 87.0, 84.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 85.6}, {"lowerIsBetter": true, "replicates": [92.0, 93.0, 93.0, 93.0, 92.0, 93.0, 93.0, 111.0, 151.0, 120.0], "unit": "score", "name": "imaging-darkroom", "value": 103.1}, {"lowerIsBetter": true, "replicates": [87.0, 89.0, 88.0, 89.0, 88.0, 87.0, 90.0, 90.0, 88.0, 85.0], "unit": "score", "name": "imaging-desaturate", "value": 88.1}, {"lowerIsBetter": true, "replicates": [55.0, 53.0, 54.0, 52.0, 55.0, 53.0, 54.0, 63.0, 53.0, 51.0], "unit": "score", "name": "json-parse-financial", "value": 54.3}, {"lowerIsBetter": true, "replicates": [64.0, 70.0, 72.0, 77.0, 70.0, 67.0, 66.0, 66.0, 66.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.6}, {"lowerIsBetter": true, "replicates": [83.0, 82.0, 80.0, 83.0, 85.0, 82.0, 80.0, 81.0, 83.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.3}, {"lowerIsBetter": true, "replicates": [131.0, 125.0, 119.0, 132.0, 128.0, 124.0, 118.0, 122.0, 108.0, 153.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 126.0}, {"lowerIsBetter": true, "replicates": [139.0, 126.0, 137.0, 138.0, 135.0, 126.0, 138.0, 137.0, 138.0, 135.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 134.9}, {"lowerIsBetter": true, "replicates": [69.0, 66.0, 65.0, 67.0, 65.0, 68.0, 68.0, 68.0, 64.0, 94.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.4}], "name": "kraken", "value": 1418.9000000000003}]} 10:30:01 INFO - Return code: 0 10:30:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 10:30:01 INFO - # TBPL SUCCESS # 10:30:01 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:30:01 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:30:01 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:30:01 INFO - 2016-03-08 10:30:01.451 screenresolution[1681:10201] starting screenresolution argv=screenresolution get 10:30:01 INFO - 2016-03-08 10:30:01.454 screenresolution[1681:10201] Display 0: 1600x1200x32@60 10:30:01 INFO - 2016-03-08 10:30:01.460 screenresolution[1682:10204] starting screenresolution argv=screenresolution list 10:30:01 INFO - Available Modes on Display 0 10:30:01 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:30:01 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:30:01 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:30:01 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:30:01 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:30:01 INFO - Intel Iris: 10:30:01 INFO - Chipset Model: Intel Iris 10:30:01 INFO - Type: GPU 10:30:01 INFO - Bus: Built-In 10:30:01 INFO - VRAM (Dynamic, Max): 1536 MB 10:30:01 INFO - Vendor: Intel (0x8086) 10:30:01 INFO - Device ID: 0x0a2e 10:30:01 INFO - Revision ID: 0x0009 10:30:01 INFO - Displays: 10:30:01 INFO - Display: 10:30:01 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:30:01 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:30:01 INFO - Display Serial Number: 1600x1200 60 10:30:01 INFO - Main Display: Yes 10:30:01 INFO - Mirror: Off 10:30:01 INFO - Online: Yes 10:30:01 INFO - Rotation: Supported 10:30:01 INFO - Return code: 0 10:30:01 INFO - Running post-action listener: _resource_record_post_action 10:30:01 INFO - Running post-run listener: _resource_record_post_run 10:30:02 INFO - Total resource usage - Wall time: 1206s; CPU: 53.0%; Read bytes: 34127360; Write bytes: 707197440; Read time: 361; Write time: 1904 10:30:02 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 397033984; Write bytes: 392820736; Read time: 30215; Write time: 710 10:30:02 INFO - run-tests - Wall time: 1173s; CPU: 53.0%; Read bytes: 32345600; Write bytes: 297864192; Read time: 344; Write time: 1140 10:30:02 INFO - Running post-run listener: _upload_blobber_files 10:30:02 INFO - Blob upload gear active. 10:30:02 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:30:02 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 10:30:02 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'] 10:30:02 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 10:30:03 INFO - (blobuploader) - INFO - Open directory for files ... 10:30:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 10:30:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:30:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:30:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 10:30:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:30:04 INFO - (blobuploader) - INFO - Done attempting. 10:30:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 10:30:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:30:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:30:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 10:30:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:30:05 INFO - (blobuploader) - INFO - Done attempting. 10:30:05 INFO - (blobuploader) - INFO - Iteration through files over. 10:30:05 INFO - Return code: 0 10:30:05 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:30:05 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:30:05 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0e5eda6656192aa7bb11b87310229fa81eb568bf3d2de16ab48eb5f7b5822dc852f9bc75b16740c44c1ed9fd11ca1c5e6cefff6ceb5b6c730e1871bb6b34d98f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc1f6ec226ecc398e5dee0940bb9fd65d7f0866ea59c36f6ac2676eb89ec3f9fcd4abf2a20bcded9c4b1af359b4689569a286432bc34f306ab1af64ba6777ab6"} 10:30:05 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:30:05 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:30:05 INFO - Contents: 10:30:05 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0e5eda6656192aa7bb11b87310229fa81eb568bf3d2de16ab48eb5f7b5822dc852f9bc75b16740c44c1ed9fd11ca1c5e6cefff6ceb5b6c730e1871bb6b34d98f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc1f6ec226ecc398e5dee0940bb9fd65d7f0866ea59c36f6ac2676eb89ec3f9fcd4abf2a20bcded9c4b1af359b4689569a286432bc34f306ab1af64ba6777ab6"} 10:30:05 INFO - Running post-run listener: copy_logs_to_upload_dir 10:30:05 INFO - Copying logs to upload dir... 10:30:05 INFO - mkdir: /builds/slave/test/build/upload/logs 10:30:05 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1261.472220 ========= master_lag: 338.25 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 26 mins, 39 secs) (at 2016-03-08 10:35:43.776130) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 3 mins, 5 secs) (at 2016-03-08 10:35:43.784025) ========= 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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/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/0e5eda6656192aa7bb11b87310229fa81eb568bf3d2de16ab48eb5f7b5822dc852f9bc75b16740c44c1ed9fd11ca1c5e6cefff6ceb5b6c730e1871bb6b34d98f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc1f6ec226ecc398e5dee0940bb9fd65d7f0866ea59c36f6ac2676eb89ec3f9fcd4abf2a20bcded9c4b1af359b4689569a286432bc34f306ab1af64ba6777ab6"} build_url:https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011705 build_url: 'https://queue.taskcluster.net/v1/task/LoiBnmqzQsWSMua6STn77Q/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0e5eda6656192aa7bb11b87310229fa81eb568bf3d2de16ab48eb5f7b5822dc852f9bc75b16740c44c1ed9fd11ca1c5e6cefff6ceb5b6c730e1871bb6b34d98f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc1f6ec226ecc398e5dee0940bb9fd65d7f0866ea59c36f6ac2676eb89ec3f9fcd4abf2a20bcded9c4b1af359b4689569a286432bc34f306ab1af64ba6777ab6"}' ========= master_lag: 185.63 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 3 mins, 5 secs) (at 2016-03-08 10:38:49.421324) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 23 secs) (at 2016-03-08 10:38:49.421646) ========= 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.BwOIFmRSzI/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.AHRjOHMSKK/Listeners TMPDIR=/var/folders/sn/mz3kt0bj0yzbmvjqtdrsjfz000000w/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.005491 ========= master_lag: 23.30 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 23 secs) (at 2016-03-08 10:39:12.724020) ========= ========= Started reboot skipped (results: 3, elapsed: 11 secs) (at 2016-03-08 10:39:12.724314) ========= ========= Finished reboot skipped (results: 3, elapsed: 11 secs) (at 2016-03-08 10:39:24.678470) ========= ========= Total master_lag: 555.46 =========