builder: fx-team_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0059 starttime: 1457355630.08 results: success (0) buildid: 20160307032710 builduid: dc37fc5f1d3548d795fd62cb376f8b15 revision: 209b08d0d9b19d8b5f9c1672f9ac628c1893c61c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:30.083549) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:30.083955) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:30.088277) ========= 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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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.005633 basedir: '/builds/slave/test' ========= master_lag: 0.07 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:30.159495) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-03-07 05:00:30.159831) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-03-07 05:00:31.869821) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:31.870276) ========= 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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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.005312 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:31.922633) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:31.922956) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:31.923377) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:31.923669) ========= 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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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-07 05:00:31-- 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% 7.96M=0.001s 2016-03-07 05:00:32 (7.96 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.324386 ========= master_lag: 0.16 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:32.405596) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:32.405940) ========= 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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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.019304 ========= master_lag: 0.12 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:32.545095) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-07 05:00:32.545486) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 209b08d0d9b19d8b5f9c1672f9ac628c1893c61c --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 209b08d0d9b19d8b5f9c1672f9ac628c1893c61c --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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-07 05:00:32,620 truncating revision to first 12 chars 2016-03-07 05:00:32,620 Setting DEBUG logging. 2016-03-07 05:00:32,621 attempt 1/10 2016-03-07 05:00:32,621 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/209b08d0d9b1?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-07 05:00:33,846 unpacking tar archive at: fx-team-209b08d0d9b1/testing/mozharness/ program finished with exit code 0 elapsedTime=1.475262 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-07 05:00:34.037916) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:34.038284) ========= echo 209b08d0d9b19d8b5f9c1672f9ac628c1893c61c in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'209b08d0d9b19d8b5f9c1672f9ac628c1893c61c'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 209b08d0d9b19d8b5f9c1672f9ac628c1893c61c program finished with exit code 0 elapsedTime=0.005606 script_repo_revision: '209b08d0d9b19d8b5f9c1672f9ac628c1893c61c' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:34.093446) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:34.093757) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-07 05:00:34.110910) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 11 secs) (at 2016-03-07 05:00:34.111207) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:00:34 INFO - MultiFileLogger online at 20160307 05:00:34 in /builds/slave/test 05:00:34 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 05:00:34 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:00:34 INFO - {'append_to_log': False, 05:00:34 INFO - 'base_work_dir': '/builds/slave/test', 05:00:34 INFO - 'blob_upload_branch': 'Fx-Team', 05:00:34 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:00:34 INFO - 'branch': 'Fx-Team', 05:00:34 INFO - 'buildbot_json_path': 'buildprops.json', 05:00:34 INFO - 'config_files': ('talos/mac_config.py',), 05:00:34 INFO - 'default_actions': ('clobber', 05:00:34 INFO - 'read-buildbot-config', 05:00:34 INFO - 'download-and-extract', 05:00:34 INFO - 'populate-webroot', 05:00:34 INFO - 'create-virtualenv', 05:00:34 INFO - 'install', 05:00:34 INFO - 'run-tests'), 05:00:34 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:00:34 INFO - 'download_minidump_stackwalk': True, 05:00:34 INFO - 'download_symbols': 'ondemand', 05:00:34 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:00:34 INFO - 'tooltool.py': '/tools/tooltool.py', 05:00:34 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:00:34 INFO - '/tools/misc-python/virtualenv.py')}, 05:00:34 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:00:34 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:00:34 INFO - 'installer_path': 'installer.exe', 05:00:34 INFO - 'log_level': 'info', 05:00:34 INFO - 'log_name': 'talos', 05:00:34 INFO - 'log_to_console': True, 05:00:34 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 05:00:34 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 05:00:34 INFO - 'opt_config_files': (), 05:00:34 INFO - 'pip_index': False, 05:00:34 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:00:34 INFO - 'cmd': ('bash', 05:00:34 INFO - '-c', 05:00:34 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:00:34 INFO - 'enabled': True, 05:00:34 INFO - 'halt_on_failure': False, 05:00:34 INFO - 'name': 'check_screen_resolution'},), 05:00:34 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:00:34 INFO - 'cmd': ('bash', 05:00:34 INFO - '-c', 05:00:34 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:00:34 INFO - 'enabled': True, 05:00:34 INFO - 'halt_on_failure': False, 05:00:34 INFO - 'name': 'check_screen_resolution'},), 05:00:34 INFO - 'run_cmd_checks_enabled': True, 05:00:34 INFO - 'sps_profile': False, 05:00:34 INFO - 'sps_profile_interval': 0, 05:00:34 INFO - 'suite': 'dromaeojs-e10s', 05:00:34 INFO - 'system_bits': '32', 05:00:34 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:00:34 INFO - 'title': 't-yosemite-r7-0059', 05:00:34 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:00:34 INFO - 'use_talos_json': True, 05:00:34 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:00:34 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:00:34 INFO - 'work_dir': 'build'} 05:00:34 INFO - ##### 05:00:34 INFO - ##### Running clobber step. 05:00:34 INFO - ##### 05:00:34 INFO - Running pre-action listener: _resource_record_pre_action 05:00:34 INFO - Running main action method: clobber 05:00:34 INFO - rmtree: /builds/slave/test/build 05:00:34 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:00:35 INFO - Running post-action listener: _resource_record_post_action 05:00:35 INFO - ##### 05:00:35 INFO - ##### Running read-buildbot-config step. 05:00:35 INFO - ##### 05:00:35 INFO - Running pre-action listener: _resource_record_pre_action 05:00:35 INFO - Running main action method: read_buildbot_config 05:00:35 INFO - Using buildbot properties: 05:00:35 INFO - { 05:00:35 INFO - "project": "", 05:00:35 INFO - "product": "firefox", 05:00:35 INFO - "script_repo_revision": "production", 05:00:35 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs-e10s", 05:00:35 INFO - "repository": "", 05:00:35 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs-e10s", 05:00:35 INFO - "buildid": "20160307032710", 05:00:35 INFO - "pgo_build": "False", 05:00:35 INFO - "basedir": "/builds/slave/test", 05:00:35 INFO - "buildnumber": 466, 05:00:35 INFO - "slavename": "t-yosemite-r7-0059", 05:00:35 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 05:00:35 INFO - "platform": "yosemite_r7", 05:00:35 INFO - "scheduler": "tests-fx-team-macosx64-talos", 05:00:35 INFO - "branch": "fx-team", 05:00:35 INFO - "repo_path": "integration/fx-team", 05:00:35 INFO - "revision": "209b08d0d9b19d8b5f9c1672f9ac628c1893c61c", 05:00:35 INFO - "stage_platform": "macosx64", 05:00:35 INFO - "builduid": "dc37fc5f1d3548d795fd62cb376f8b15", 05:00:35 INFO - "slavebuilddir": "test" 05:00:35 INFO - } 05:00:35 INFO - Found installer url https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg. 05:00:35 INFO - Running post-action listener: _resource_record_post_action 05:00:35 INFO - ##### 05:00:35 INFO - ##### Running download-and-extract step. 05:00:35 INFO - ##### 05:00:35 INFO - Running pre-action listener: _resource_record_pre_action 05:00:35 INFO - Running main action method: download_and_extract 05:00:35 INFO - mkdir: /builds/slave/test/build/tests 05:00:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:00:35 INFO - https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 05:00:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.test_packages.json 05:00:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.test_packages.json 05:00:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:37 INFO - Downloaded 1277 bytes. 05:00:37 INFO - Reading from file /builds/slave/test/build/firefox-47.0a1.en-US.mac.test_packages.json 05:00:37 INFO - Using the following test package requirements: 05:00:37 INFO - {u'common': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 05:00:37 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 05:00:37 INFO - u'firefox-47.0a1.en-US.mac.cppunittest.tests.zip'], 05:00:37 INFO - u'gtest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 05:00:37 INFO - u'firefox-47.0a1.en-US.mac.gtest.tests.zip'], 05:00:37 INFO - u'jittest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 05:00:37 INFO - u'jsshell-mac.zip'], 05:00:37 INFO - u'mochitest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 05:00:37 INFO - u'firefox-47.0a1.en-US.mac.mochitest.tests.zip'], 05:00:37 INFO - u'mozbase': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 05:00:37 INFO - u'reftest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 05:00:37 INFO - u'firefox-47.0a1.en-US.mac.reftest.tests.zip'], 05:00:37 INFO - u'talos': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 05:00:37 INFO - u'firefox-47.0a1.en-US.mac.talos.tests.zip'], 05:00:37 INFO - u'web-platform': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 05:00:37 INFO - u'firefox-47.0a1.en-US.mac.web-platform.tests.zip'], 05:00:37 INFO - u'webapprt': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 05:00:37 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 05:00:37 INFO - u'firefox-47.0a1.en-US.mac.xpcshell.tests.zip']} 05:00:37 INFO - Downloading packages: [u'firefox-47.0a1.en-US.mac.common.tests.zip'] for test suite category: common 05:00: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')]} 05:00:37 INFO - https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 05:00:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 05:00:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 05:00:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:47 INFO - Downloaded 17866385 bytes. 05:00:47 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'] 05:00:47 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 05:00:50 INFO - Return code: 0 05:00:50 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 05:00: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')]} 05:00:50 INFO - https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 05:00:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 05:00:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 05:00:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:52 INFO - Downloaded 17866385 bytes. 05:00:52 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'] 05:00:52 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 05:00:55 INFO - Return code: 0 05:00:55 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')]} 05:00:55 INFO - https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 05:00:55 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip 05:00:55 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip 05:00:55 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:56 INFO - Downloaded 10845161 bytes. 05:00:56 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'] 05:00:56 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 05:00:57 INFO - Return code: 0 05:00:57 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')]} 05:00:57 INFO - https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 05:00:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 05:00:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 05:00:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg 05:00:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/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 05:00:59 INFO - Downloaded 110988425 bytes. 05:00:59 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 05:00:59 INFO - mkdir: /builds/slave/test/properties 05:00:59 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:00:59 INFO - Writing to file /builds/slave/test/properties/build_url 05:00:59 INFO - Contents: 05:00:59 INFO - build_url:https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 05:01:00 INFO - Running post-action listener: _resource_record_post_action 05:01:00 INFO - Running post-action listener: set_extra_try_arguments 05:01:00 INFO - ##### 05:01:00 INFO - ##### Running populate-webroot step. 05:01:00 INFO - ##### 05:01:00 INFO - Running pre-action listener: _resource_record_pre_action 05:01:00 INFO - Running main action method: populate_webroot 05:01:00 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:01:00 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:01:00 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:01:00 INFO - '--tppagecycles', 05:01:00 INFO - '7'], 05:01:00 INFO - 'tests': ['tsvgm']}}, 05:01:00 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:01:00 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:01:00 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 05:01:00 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:01:00 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:01:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:01:00 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:01:00 INFO - 'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:01:00 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:01:00 INFO - 'tests': ['damp', 'tps']}, 05:01:00 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:01:00 INFO - 'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['damp', 'tps']}, 05:01:00 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:01:00 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:01:00 INFO - 'other': {'tests': ['a11yr', 05:01:00 INFO - 'ts_paint', 05:01:00 INFO - 'tpaint', 05:01:00 INFO - 'sessionrestore', 05:01:00 INFO - 'sessionrestore_no_auto_restore', 05:01:00 INFO - 'tabpaint']}, 05:01:00 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['a11yr', 05:01:00 INFO - 'ts_paint', 05:01:00 INFO - 'tpaint', 05:01:00 INFO - 'sessionrestore', 05:01:00 INFO - 'sessionrestore_no_auto_restore', 05:01:00 INFO - 'tabpaint']}, 05:01:00 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['a11yr', 05:01:00 INFO - 'ts_paint', 05:01:00 INFO - 'tpaint', 05:01:00 INFO - 'sessionrestore', 05:01:00 INFO - 'sessionrestore_no_auto_restore', 05:01:00 INFO - 'tabpaint']}, 05:01:00 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['a11yr', 05:01:00 INFO - 'ts_paint', 05:01:00 INFO - 'tpaint', 05:01:00 INFO - 'sessionrestore', 05:01:00 INFO - 'sessionrestore_no_auto_restore', 05:01:00 INFO - 'tabpaint']}, 05:01:00 INFO - 'other_l64': {'tests': ['a11yr', 05:01:00 INFO - 'ts_paint', 05:01:00 INFO - 'tpaint', 05:01:00 INFO - 'sessionrestore', 05:01:00 INFO - 'sessionrestore_no_auto_restore', 05:01:00 INFO - 'tabpaint']}, 05:01:00 INFO - 'other_nol64': {'tests': ['a11yr', 05:01:00 INFO - 'ts_paint', 05:01:00 INFO - 'tpaint', 05:01:00 INFO - 'sessionrestore', 05:01:00 INFO - 'sessionrestore_no_auto_restore', 05:01:00 INFO - 'tabpaint']}, 05:01:00 INFO - 'svgr': {'tests': ['tsvgx', 05:01:00 INFO - 'tsvgr_opacity', 05:01:00 INFO - 'tart', 05:01:00 INFO - 'tscrollx', 05:01:00 INFO - 'cart']}, 05:01:00 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['tsvgx', 05:01:00 INFO - 'tsvgr_opacity', 05:01:00 INFO - 'tart', 05:01:00 INFO - 'tscrollx', 05:01:00 INFO - 'cart']}, 05:01:00 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:01:00 INFO - 'tests': ['tp5o']}, 05:01:00 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:01:00 INFO - 'talos_options': ['--e10s'], 05:01:00 INFO - 'tests': ['tp5o']}, 05:01:00 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:01:00 INFO - 'talos_options': ['--xperf_path', 05:01:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:01:00 INFO - 'tests': ['tp5n']}, 05:01:00 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:01:00 INFO - 'talos_options': ['--e10s', 05:01:00 INFO - '--xperf_path', 05:01:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:01:00 INFO - 'tests': ['tp5n']}}, 05:01:00 INFO - 'talos.zip': {'path': '', 05:01:00 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:01:00 INFO - Running post-action listener: _resource_record_post_action 05:01:00 INFO - ##### 05:01:00 INFO - ##### Running create-virtualenv step. 05:01:00 INFO - ##### 05:01:00 INFO - Running pre-action listener: _resource_record_pre_action 05:01:00 INFO - Running main action method: create_virtualenv 05:01:00 INFO - Creating virtualenv /builds/slave/test/build/venv 05:01:00 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 05:01:00 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:01:00 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:01:00 INFO - Using real prefix '/tools/python27' 05:01:00 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:01:01 INFO - Installing distribute.............................................................................................................................................................................................done. 05:01:04 INFO - Installing pip.................done. 05:01:04 INFO - Return code: 0 05:01:04 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:01:04 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')]} 05:01:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:04 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')]} 05:01:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:04 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:04 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 05:01:04 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 05:01:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:04 INFO - 'HOME': '/Users/cltbld', 05:01:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:04 INFO - 'LOGNAME': 'cltbld', 05:01:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:04 INFO - 'MOZ_NO_REMOTE': '1', 05:01:04 INFO - 'NO_EM_RESTART': '1', 05:01:04 INFO - 'PAGER': '/bin/cat', 05:01:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:04 INFO - 'PWD': '/builds/slave/test', 05:01:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:04 INFO - 'SHELL': '/bin/bash', 05:01:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:04 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:04 INFO - 'USER': 'cltbld', 05:01:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:04 INFO - 'XPC_FLAGS': '0x0', 05:01:04 INFO - 'XPC_SERVICE_NAME': '0', 05:01:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:04 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 05:01:04 INFO - Cleaning up... 05:01:04 INFO - Return code: 0 05:01:04 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:01:04 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')]} 05:01:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:04 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')]} 05:01:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:04 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:04 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 05:01:04 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 05:01:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:04 INFO - 'HOME': '/Users/cltbld', 05:01:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:04 INFO - 'LOGNAME': 'cltbld', 05:01:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:04 INFO - 'MOZ_NO_REMOTE': '1', 05:01:04 INFO - 'NO_EM_RESTART': '1', 05:01:04 INFO - 'PAGER': '/bin/cat', 05:01:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:04 INFO - 'PWD': '/builds/slave/test', 05:01:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:04 INFO - 'SHELL': '/bin/bash', 05:01:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:04 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:04 INFO - 'USER': 'cltbld', 05:01:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:04 INFO - 'XPC_FLAGS': '0x0', 05:01:04 INFO - 'XPC_SERVICE_NAME': '0', 05:01:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:05 INFO - Downloading/unpacking psutil>=0.7.1 05:01:05 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 05:01:05 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 05:01:05 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 05:01:05 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 05:01:05 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 05:01:05 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 05:01:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:01:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:01:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:01:07 INFO - Installing collected packages: psutil 05:01:07 INFO - Running setup.py install for psutil 05:01:07 INFO - building 'psutil._psutil_osx' extension 05:01:07 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 05:01:08 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 05:01:08 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 05:01:08 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 05:01:08 INFO - building 'psutil._psutil_posix' extension 05:01:08 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 05:01:08 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 05:01:08 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 05:01:08 INFO - ^ 05:01:08 INFO - 1 warning generated. 05:01:08 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 05:01:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:01:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:01:08 INFO - Successfully installed psutil 05:01:08 INFO - Cleaning up... 05:01:08 INFO - Return code: 0 05:01:08 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:01:08 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')]} 05:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:08 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')]} 05:01:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:08 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:08 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 05:01:08 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 05:01:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:08 INFO - 'HOME': '/Users/cltbld', 05:01:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:08 INFO - 'LOGNAME': 'cltbld', 05:01:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:08 INFO - 'MOZ_NO_REMOTE': '1', 05:01:08 INFO - 'NO_EM_RESTART': '1', 05:01:08 INFO - 'PAGER': '/bin/cat', 05:01:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:08 INFO - 'PWD': '/builds/slave/test', 05:01:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:08 INFO - 'SHELL': '/bin/bash', 05:01:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:08 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:08 INFO - 'USER': 'cltbld', 05:01:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:08 INFO - 'XPC_FLAGS': '0x0', 05:01:08 INFO - 'XPC_SERVICE_NAME': '0', 05:01:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:08 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:01:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:01:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:01:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:01:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:01:11 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:01:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:01:11 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:01:11 INFO - Installing collected packages: mozsystemmonitor 05:01:11 INFO - Running setup.py install for mozsystemmonitor 05:01:11 INFO - Successfully installed mozsystemmonitor 05:01:11 INFO - Cleaning up... 05:01:11 INFO - Return code: 0 05:01:11 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:01: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')]} 05:01:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01: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')]} 05:01:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:11 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:11 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 05:01:11 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 05:01:11 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:11 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:11 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:11 INFO - 'HOME': '/Users/cltbld', 05:01:11 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:11 INFO - 'LOGNAME': 'cltbld', 05:01:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:11 INFO - 'MOZ_NO_REMOTE': '1', 05:01:11 INFO - 'NO_EM_RESTART': '1', 05:01:11 INFO - 'PAGER': '/bin/cat', 05:01:11 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:11 INFO - 'PWD': '/builds/slave/test', 05:01:11 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:11 INFO - 'SHELL': '/bin/bash', 05:01:11 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:11 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:11 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:11 INFO - 'USER': 'cltbld', 05:01:11 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:11 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:11 INFO - 'XPC_FLAGS': '0x0', 05:01:11 INFO - 'XPC_SERVICE_NAME': '0', 05:01:11 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:12 INFO - Downloading/unpacking blobuploader==1.2.4 05:01:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:01:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:01:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:01:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:01:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:01:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:01:14 INFO - Downloading blobuploader-1.2.4.tar.gz 05:01:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:01:14 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:01:14 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 05:01:14 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 05:01:14 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 05:01:14 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 05:01:14 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 05:01:14 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 05:01:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:01:15 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:01:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:01:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:01:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:01:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:01:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:01:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:01:15 INFO - Downloading docopt-0.6.1.tar.gz 05:01:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:01:16 INFO - Installing collected packages: blobuploader, requests, docopt 05:01:16 INFO - Running setup.py install for blobuploader 05:01:16 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:01:16 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:01:16 INFO - Running setup.py install for requests 05:01:16 INFO - Running setup.py install for docopt 05:01:16 INFO - Successfully installed blobuploader requests docopt 05:01:16 INFO - Cleaning up... 05:01:16 INFO - Return code: 0 05:01:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:01: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')]} 05:01:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01: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')]} 05:01:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:16 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:16 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 05:01:16 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 05:01:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:16 INFO - 'HOME': '/Users/cltbld', 05:01:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:16 INFO - 'LOGNAME': 'cltbld', 05:01:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:16 INFO - 'MOZ_NO_REMOTE': '1', 05:01:16 INFO - 'NO_EM_RESTART': '1', 05:01:16 INFO - 'PAGER': '/bin/cat', 05:01:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:16 INFO - 'PWD': '/builds/slave/test', 05:01:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:16 INFO - 'SHELL': '/bin/bash', 05:01:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:16 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:16 INFO - 'USER': 'cltbld', 05:01:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:16 INFO - 'XPC_FLAGS': '0x0', 05:01:16 INFO - 'XPC_SERVICE_NAME': '0', 05:01:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:01:17 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-eIYETu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:01:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:01:17 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-5kBGo6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:01:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:01:17 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-_zRSl_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:01:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:01:17 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-AVgNiD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:01:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:01:17 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-7Mnoyz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:01:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:01:17 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-lJ6OLa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:01:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:01:17 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-yMx1ZJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:01:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:01:17 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-KgrBVh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-JQUaYB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-Jgf0ua-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-3E5iea-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-zZ2PLp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-5mgZcS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-UNhmwd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-MRvbqL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-laECI9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:01:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:01:18 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-XRZvpU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:01:18 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:01:18 INFO - Running setup.py install for manifestparser 05:01:19 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:01:19 INFO - Running setup.py install for mozcrash 05:01:19 INFO - Running setup.py install for mozdebug 05:01:19 INFO - Running setup.py install for mozdevice 05:01:19 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:01:19 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:01:19 INFO - Running setup.py install for mozfile 05:01:19 INFO - Running setup.py install for mozhttpd 05:01:19 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:01:19 INFO - Running setup.py install for mozinfo 05:01:19 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Running setup.py install for mozInstall 05:01:20 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Running setup.py install for mozleak 05:01:20 INFO - Running setup.py install for mozlog 05:01:20 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Running setup.py install for moznetwork 05:01:20 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Running setup.py install for mozprocess 05:01:20 INFO - Running setup.py install for mozprofile 05:01:20 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:01:20 INFO - Running setup.py install for mozrunner 05:01:21 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:01:21 INFO - Running setup.py install for mozscreenshot 05:01:21 INFO - Running setup.py install for moztest 05:01:21 INFO - Running setup.py install for mozversion 05:01:21 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:01:21 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:01:21 INFO - Cleaning up... 05:01:21 INFO - Return code: 0 05:01:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:01:21 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')]} 05:01:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:21 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')]} 05:01:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:21 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:21 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 05:01:21 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 05:01:21 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:21 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:21 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:21 INFO - 'HOME': '/Users/cltbld', 05:01:21 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:21 INFO - 'LOGNAME': 'cltbld', 05:01:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:21 INFO - 'MOZ_NO_REMOTE': '1', 05:01:21 INFO - 'NO_EM_RESTART': '1', 05:01:21 INFO - 'PAGER': '/bin/cat', 05:01:21 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:21 INFO - 'PWD': '/builds/slave/test', 05:01:21 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:21 INFO - 'SHELL': '/bin/bash', 05:01:21 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:21 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:21 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:21 INFO - 'USER': 'cltbld', 05:01:21 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:21 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:21 INFO - 'XPC_FLAGS': '0x0', 05:01:21 INFO - 'XPC_SERVICE_NAME': '0', 05:01:21 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:01:21 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-cKsark-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:01:21 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)) 05:01:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:01:21 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-YKrqzS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-xGA_pW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-bJo9GV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-tOCS2E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-vRoTUf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-aAdOiI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-LDMJ7E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-5CCsH_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-9nc20K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:01:22 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-ot1VJG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:01:22 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)) 05:01:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:01:23 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-m0N0o1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:01:23 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)) 05:01:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:01:23 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-G_iFhU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:01:23 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)) 05:01:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:01:23 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-gG5Tv7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:01:23 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)) 05:01:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:01:23 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-2VtJn3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:01:23 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)) 05:01:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:01:23 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-SDNkaD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:01:23 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)) 05:01:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:01:23 INFO - Running setup.py (path:/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/pip-FCzbPJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:01:23 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)) 05:01:23 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)) 05:01:23 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)) 05:01:23 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)) 05:01:23 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)) 05:01:23 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)) 05:01:23 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:01:23 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 05:01:23 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 05:01:23 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 05:01:23 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 05:01:23 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 05:01:23 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 05:01:26 INFO - Downloading blessings-1.6.tar.gz 05:01:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:01:26 INFO - Installing collected packages: blessings 05:01:26 INFO - Running setup.py install for blessings 05:01:26 INFO - Successfully installed blessings 05:01:26 INFO - Cleaning up... 05:01:26 INFO - Return code: 0 05:01:26 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:01:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:01:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:01:26 INFO - Reading from file tmpfile_stdout 05:01:26 INFO - Current package versions: 05:01:26 INFO - blessings == 1.6 05:01:26 INFO - blobuploader == 1.2.4 05:01:26 INFO - docopt == 0.6.1 05:01:26 INFO - manifestparser == 1.1 05:01:26 INFO - mozInstall == 1.12 05:01:26 INFO - mozcrash == 0.17 05:01:26 INFO - mozdebug == 0.1 05:01:26 INFO - mozdevice == 0.48 05:01:26 INFO - mozfile == 1.2 05:01:26 INFO - mozhttpd == 0.7 05:01:26 INFO - mozinfo == 0.9 05:01:26 INFO - mozleak == 0.1 05:01:26 INFO - mozlog == 3.1 05:01:26 INFO - moznetwork == 0.27 05:01:26 INFO - mozprocess == 0.22 05:01:26 INFO - mozprofile == 0.28 05:01:26 INFO - mozrunner == 6.11 05:01:26 INFO - mozscreenshot == 0.1 05:01:26 INFO - mozsystemmonitor == 0.0 05:01:26 INFO - moztest == 0.7 05:01:26 INFO - mozversion == 1.4 05:01:26 INFO - psutil == 3.1.1 05:01:26 INFO - requests == 1.2.3 05:01:26 INFO - wsgiref == 0.1.2 05:01:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:01:26 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')]} 05:01:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:26 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')]} 05:01:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:26 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:26 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 05:01:26 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 05:01:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:26 INFO - 'HOME': '/Users/cltbld', 05:01:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:26 INFO - 'LOGNAME': 'cltbld', 05:01:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:26 INFO - 'MOZ_NO_REMOTE': '1', 05:01:26 INFO - 'NO_EM_RESTART': '1', 05:01:26 INFO - 'PAGER': '/bin/cat', 05:01:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:26 INFO - 'PWD': '/builds/slave/test', 05:01:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:26 INFO - 'SHELL': '/bin/bash', 05:01:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:26 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:26 INFO - 'USER': 'cltbld', 05:01:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:26 INFO - 'XPC_FLAGS': '0x0', 05:01:26 INFO - 'XPC_SERVICE_NAME': '0', 05:01:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 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)) 05:01:26 INFO - Cleaning up... 05:01:26 INFO - Return code: 0 05:01:26 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:01:26 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')]} 05:01:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:26 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')]} 05:01:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:26 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:26 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 05:01:26 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 05:01:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:26 INFO - 'HOME': '/Users/cltbld', 05:01:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:26 INFO - 'LOGNAME': 'cltbld', 05:01:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:26 INFO - 'MOZ_NO_REMOTE': '1', 05:01:26 INFO - 'NO_EM_RESTART': '1', 05:01:26 INFO - 'PAGER': '/bin/cat', 05:01:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:26 INFO - 'PWD': '/builds/slave/test', 05:01:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:26 INFO - 'SHELL': '/bin/bash', 05:01:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:26 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:26 INFO - 'USER': 'cltbld', 05:01:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:26 INFO - 'XPC_FLAGS': '0x0', 05:01:26 INFO - 'XPC_SERVICE_NAME': '0', 05:01:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:27 INFO - Downloading/unpacking jsonschema 05:01:27 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 05:01:27 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 05:01:27 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 05:01:27 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 05:01:27 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 05:01:27 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 05:01:29 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:01:29 INFO - Downloading/unpacking functools32 (from jsonschema) 05:01:29 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 05:01:29 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 05:01:29 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 05:01:29 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 05:01:29 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 05:01:29 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 05:01:29 INFO - Downloading functools32-3.2.3-2.tar.gz 05:01:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:01:29 INFO - warning: no files found matching '*.txt' 05:01:29 INFO - no previously-included directories found matching 'build' 05:01:29 INFO - no previously-included directories found matching 'dist' 05:01:29 INFO - no previously-included directories found matching '.git*' 05:01:29 INFO - Installing collected packages: jsonschema, functools32 05:01:30 INFO - Running setup.py install for functools32 05:01:30 INFO - warning: no files found matching '*.txt' 05:01:30 INFO - no previously-included directories found matching 'build' 05:01:30 INFO - no previously-included directories found matching 'dist' 05:01:30 INFO - no previously-included directories found matching '.git*' 05:01:30 INFO - Successfully installed jsonschema functools32 05:01:30 INFO - Cleaning up... 05:01:30 INFO - Return code: 0 05:01:30 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 05:01:30 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')]} 05:01:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:30 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')]} 05:01:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:01:30 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 0x106258a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10625f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdaa959b140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, '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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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 05:01:30 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 05:01:30 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 05:01:30 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:01:30 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:01:30 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:01:30 INFO - 'HOME': '/Users/cltbld', 05:01:30 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:01:30 INFO - 'LOGNAME': 'cltbld', 05:01:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:30 INFO - 'MOZ_NO_REMOTE': '1', 05:01:30 INFO - 'NO_EM_RESTART': '1', 05:01:30 INFO - 'PAGER': '/bin/cat', 05:01:30 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:01:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:01:30 INFO - 'PWD': '/builds/slave/test', 05:01:30 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:01:30 INFO - 'SHELL': '/bin/bash', 05:01:30 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:01:30 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:01:30 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:01:30 INFO - 'USER': 'cltbld', 05:01:30 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:01:30 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:01:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:01:30 INFO - 'XPC_FLAGS': '0x0', 05:01:30 INFO - 'XPC_SERVICE_NAME': '0', 05:01:30 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:01:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:01:30 INFO - Downloading/unpacking flake8 05:01: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 05:01: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 05:01: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 05:01: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 05:01: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 05:01: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 05:01:32 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:01:32 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:01:32 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 05:01:32 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 05:01:32 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 05:01:32 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 05:01:32 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 05:01:32 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 05:01:33 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:01:33 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:01: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 05:01: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 05:01: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 05:01: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 05:01: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 05:01: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 05:01:33 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:01: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 05:01: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 05:01: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 05:01: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 05:01: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 05:01: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 05:01:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 05:01:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:01:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:01:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:01:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:01:34 INFO - no previously-included directories found matching 'docs/_build' 05:01:34 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:01:34 INFO - Running setup.py install for pep8 05:01:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:01:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:01:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:01:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:01:34 INFO - no previously-included directories found matching 'docs/_build' 05:01:34 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 05:01:34 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:01:34 INFO - Cleaning up... 05:01:34 INFO - Return code: 0 05:01:34 INFO - Running post-action listener: _resource_record_post_action 05:01:34 INFO - Running post-action listener: _start_resource_monitoring 05:01:34 INFO - Starting resource monitoring. 05:01:34 INFO - ##### 05:01:34 INFO - ##### Running install step. 05:01:34 INFO - ##### 05:01:34 INFO - Running pre-action listener: _resource_record_pre_action 05:01:34 INFO - Running main action method: install 05:01:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:01:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:01:34 INFO - Reading from file tmpfile_stdout 05:01:34 INFO - Detecting whether we're running mozinstall >=1.0... 05:01:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:01:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:01:34 INFO - Reading from file tmpfile_stdout 05:01:34 INFO - Output received: 05:01:34 INFO - Usage: mozinstall [options] installer 05:01:34 INFO - Options: 05:01:34 INFO - -h, --help show this help message and exit 05:01:34 INFO - -d DEST, --destination=DEST 05:01:34 INFO - Directory to install application into. [default: 05:01:34 INFO - "/builds/slave/test"] 05:01:34 INFO - --app=APP Application being installed. [default: firefox] 05:01:34 INFO - mkdir: /builds/slave/test/build/application 05:01:34 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'] 05:01:34 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 05:02:08 INFO - Reading from file tmpfile_stdout 05:02:08 INFO - Output received: 05:02:08 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 05:02:08 INFO - Running post-action listener: _resource_record_post_action 05:02:08 INFO - ##### 05:02:08 INFO - ##### Running run-tests step. 05:02:08 INFO - ##### 05:02:08 INFO - Running pre-action listener: _resource_record_pre_action 05:02:08 INFO - Running main action method: run_tests 05:02:08 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:02:08 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:02:08 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:02:08 INFO - 2016-03-07 05:02:08.828 screenresolution[1957:29421] starting screenresolution argv=screenresolution get 05:02:08 INFO - 2016-03-07 05:02:08.831 screenresolution[1957:29421] Display 0: 1600x1200x32@60 05:02:08 INFO - 2016-03-07 05:02:08.836 screenresolution[1958:29423] starting screenresolution argv=screenresolution list 05:02:08 INFO - Available Modes on Display 0 05:02:08 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:02:08 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:02:08 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:02:08 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:02:09 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:02:09 INFO - Intel Iris: 05:02:09 INFO - Chipset Model: Intel Iris 05:02:09 INFO - Type: GPU 05:02:09 INFO - Bus: Built-In 05:02:09 INFO - VRAM (Dynamic, Max): 1536 MB 05:02:09 INFO - Vendor: Intel (0x8086) 05:02:09 INFO - Device ID: 0x0a2e 05:02:09 INFO - Revision ID: 0x0009 05:02:09 INFO - Displays: 05:02:09 INFO - Display: 05:02:09 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:02:09 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:02:09 INFO - Display Serial Number: 1600x1200 60 05:02:09 INFO - Main Display: Yes 05:02:09 INFO - Mirror: Off 05:02:09 INFO - Online: Yes 05:02:09 INFO - Rotation: Supported 05:02:09 INFO - Return code: 0 05:02:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:02:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:02:09 INFO - Python 2.7.3 05:02:09 INFO - Return code: 0 05:02:09 INFO - grabbing minidump binary from tooltool 05:02:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:09 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 0x1060fcd30>, '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 0x105f20db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1060f3b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:02:09 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 05:02:09 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 05:02:09 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:02:09 INFO - Return code: 0 05:02:09 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 05:02:09 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:02:09 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:02:09 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 05:02:09 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:02:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 05:02:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 05:02:10 INFO - Return code: 0 05:02:10 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-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0059', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 05:02:10 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-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0059 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:02:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.qhayTlzNPQ/Render', 05:02:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:02:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:02:10 INFO - 'HOME': '/Users/cltbld', 05:02:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:02:10 INFO - 'LOGNAME': 'cltbld', 05:02:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:02:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 05:02:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:02:10 INFO - 'MOZ_NO_REMOTE': '1', 05:02:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:02:10 INFO - 'NO_EM_RESTART': '1', 05:02:10 INFO - 'PAGER': '/bin/cat', 05:02:10 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:02:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:02:10 INFO - 'PWD': '/builds/slave/test', 05:02:10 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:02:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:02:10 INFO - 'SHELL': '/bin/bash', 05:02:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zvfaz7xLPM/Listeners', 05:02:10 INFO - 'TMPDIR': '/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/', 05:02:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:02:10 INFO - 'USER': 'cltbld', 05:02:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:02:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:02:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:02:10 INFO - 'XPC_FLAGS': '0x0', 05:02:10 INFO - 'XPC_SERVICE_NAME': '0', 05:02:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:02:10 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0059', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:02:10 INFO - mozversion application_buildid: 20160307032710 05:02:10 INFO - mozversion application_changeset: 209b08d0d9b19d8b5f9c1672f9ac628c1893c61c 05:02:10 INFO - mozversion application_display_name: Nightly 05:02:10 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:02:10 INFO - mozversion application_name: Firefox 05:02:10 INFO - mozversion application_remotingname: firefox 05:02:10 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 05:02:10 INFO - mozversion application_vendor: Mozilla 05:02:10 INFO - mozversion application_version: 47.0a1 05:02:10 INFO - mozversion platform_buildid: 20160307032710 05:02:10 INFO - mozversion platform_changeset: 209b08d0d9b19d8b5f9c1672f9ac628c1893c61c 05:02:10 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 05:02:10 INFO - mozversion platform_version: 47.0a1 05:02:10 INFO - using testdate: 1457355730 05:02:10 INFO - actual date: 1457355730 05:02:10 INFO - starting webserver on 'localhost:51915' 05:02:10 INFO - SUITE-START | Running 2 tests 05:02:10 INFO - TEST-START | dromaeo_css 05:02:10 INFO - operating with platform_type : mac_ 05:02:10 INFO - Initialising browser for dromaeo_css test... 05:02:10 INFO - TEST-INFO | started process 1976 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/tmp2BL6ol/profile http://localhost:51915/getInfo.html) 05:02:13 INFO - PROCESS | 1976 | __metrics Screen width/height:1600/1200 05:02:13 INFO - PROCESS | 1976 | colorDepth:24 05:02:13 INFO - PROCESS | 1976 | Browser inner width/height: 1024/689 05:02:13 INFO - PROCESS | 1976 | __metrics 05:02:13 ERROR - PROCESS | 1976 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 05:02:14 INFO - TEST-INFO | 1976: exit 0 05:02:14 INFO - Browser initialized. 05:02:14 INFO - Running cycle 1/1 for dromaeo_css test... 05:02:14 INFO - TEST-INFO | started process 1981 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/tmp2BL6ol/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:02:26 INFO - PROCESS | 1981 | RSS: Main: 256159744 05:02:26 INFO - PROCESS | 1981 | 05:03:15 INFO - PROCESS | 1981 | 1457355795732 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] 05:05:26 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:51915/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51915/tests/dromaeo/cssquery-ext.html) 05:05:27 INFO - PROCESS | 1981 | RSS: Main: 271474688 05:05:27 INFO - PROCESS | 1981 | 05:08:29 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:51915/tests/dromaeo/cssquery-ext.html (next: http://localhost:51915/tests/dromaeo/cssquery-jquery.html) 05:08:30 INFO - PROCESS | 1981 | RSS: Main: 283209728 05:08:30 INFO - PROCESS | 1981 | 05:11:32 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:51915/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51915/tests/dromaeo/cssquery-mootools.html) 05:11:32 INFO - PROCESS | 1981 | RSS: Main: 285650944 05:11:32 INFO - PROCESS | 1981 | 05:14:34 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:51915/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51915/tests/dromaeo/cssquery-prototype.html) 05:14:35 INFO - PROCESS | 1981 | RSS: Main: 285634560 05:14:35 INFO - PROCESS | 1981 | 05:17:37 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:51915/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51915/tests/dromaeo/cssquery-yui.html) 05:17:38 INFO - PROCESS | 1981 | RSS: Main: 288419840 05:17:38 INFO - PROCESS | 1981 | 05:20:40 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:51915/tests/dromaeo/cssquery-yui.html (next: http://localhost:51915/tests/dromaeo/cssquery-dojo.html) 05:20:41 INFO - PROCESS | 1981 | RSS: Main: 291803136 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - PROCESS | 1981 | __start_tp_report 05:20:41 INFO - PROCESS | 1981 | _x_x_mozilla_page_load 05:20:41 INFO - PROCESS | 1981 | _x_x_mozilla_page_load_details 05:20:41 INFO - PROCESS | 1981 | |i|pagename|runs| 05:20:41 INFO - PROCESS | 1981 | |0;dojo.html;2903.448344814485;2925.195571217916;3041.7718671099674;3486.4944583035453;3563.8574457021705;4985.850424487262;5546.5562754979655;5805.24531810865;5836.182934389189;5857.648541087532;5686.658800471974;5697.6296540724825;5794.507466865311;5836.9124463133085;5941.910871336922;5233.555147812431;5235.842924712265;5298.046351656701;5298.205269209611;5335.759890804904;5280.841574752744;5282.709450980195;5305.495977882114;5324.973375133139;5332.040232758121;5194.194899790538;5225.111731005719;5294.947050529484;5307.840764777063;5322.813701520467;5234.0840352938085;5254.0805359062015;5273.789048438058;5291.603129765283;5349.090654588729;4308.224519586473;5225.790968361261;5228.764705588258;5279.1817268323475;5280.762365693553;5622.381538030813;5671.9716401418145;5724.542036637101;5748.827535173951;5755.712214389264;6196.101565273055;6229.781957631507;6253.874922501524;6274.341194174637;6300.621962682208;6144.893919094561;6173.259208894961;6224.564280500367;6240.31356550779;6249.75000999964;5932.228810254683;5944.762209511571;5948.85127871798;5953.493953013999;5955.43423374783;6320.302622965617;6330.3669633036325;6334.334894836068;6352.968235158887;6367.808965731036;6093.969530152321;6136.754529818846;6140.596275277727;6154.323024467305;6249.375062493805;5330.307060082242;6132.908006379907;6146.969265153645;6231.532635052389;6244.094606282064;6108.480779133734;6231.563790534619;6246.531510136758;6249.531285153541;6255.78104766331;6104.822969073627;6145.125736650364;6152.753889844445;6225.6264624121795;6247.406496382836;4894.19245824435;4937.308776771255;4941.160002799461;4947.505249475023;4957.801687932514;4437.556244375537;4445.022095139129;4451.755153466591;4457.175422546774;4473.194824931478;5722.799702010409;5753.827385178452;5861.824145275648;5865.912011319833;5921.703914804242;6175.980963141032;6226.533010024266;6247.375262473807;6262.937370626236;6266.780662676784;5247.685138891678;5869.413058694096;5870.442307980735;5871.911921321183;5877.735501902424;4370.972821386971;4536.88657783558;4970.254461830755;5398.838034858961;5459.372172200168;6430.935690643128;6477.4170324671;6481.999999999905;6513.185851768529;6550.967245163743;6126.761967422386;6236.975216230163;6271.341509141657;6287.717052732546;6289.811305660837;6144.354842741448;6464.935350646621;6470.0294955755135;6476.676166191766;6480.287168411377;6176.567640265318;6204.007358822567;6217.409346112112;6225.782097626561;6281.937180628135;6146.323904370426;6159.076138579249;6288.402601752826;6297.1813664223355;6297.779577714758;5264.815731449381;6099.176611157437;6101.429060711369;6191.752329906753;6213.689315534296;6112.419320164578;6169.907451388322;6173.9073913892225;6183;6197.690115494297;4758.857234282977;5813.82558523245;6035.909461358171;6050.515958723204;6095.238095238095;6114.814446323713;6150.077488376601;6161.199044124235;6183.855986642486;6214.5960512566535;6082.452579267887;6084.847878802888;6105.737880364195;6125.815438131457;6136.85608443425 05:20:41 INFO - PROCESS | 1981 | |1;ext.html;500.3895247797688;511.9308893299403;531.9255104688532;561.4049107945577;595.8927393069246;37229.81385093074;37795.055123621925;37869.62130378695;37944;37955.240895182076;36814.44778328327;38953;38999;39053.80473097638;39130.217395652144;9212.861807072883;9321.347505674605;9428.10433008863;9442.575084121198;9447.952760236189;9310.581023853943;9362.204212641933;9438.669646562372;9484.288678349118;9494.81010379792;9489.478078705668;9496.43021418717;9498.19265362445;9565.473898935556;9574.377665451759;9482.051794820498;9483.573239204252;9564.426134431957;9568.37805542641;9576.377535460242;9363.391379560375;9414.246860251164;9419.199368053723;9518.809623807485;9522.666706665303;30371.69628303733;38286.42570361447;38431;38582.61417385846;39039.8048009761;2607.2699644099494;3026.742726868219;3153.6530981592005;3207.8075315481146;3411.1642647551507;24997.250082497554;25667.871660641576;26779.33051673704;27077.729222707716;28351.86592536296;2699.433119045003;2762.240383894445;2772;2808.2979255186206;2827.816191947517;444167;446502;449816;450040;451629;45592.772036139606;46128.76935615367;46427;46476;62247;44955;45109.54890451119;45140.09719805585;45239;45513;15353.846461535464;15620;15722.606934826492;15731.44939927097;15931.36274549005;12629.368531573567;12685.921696655887;12815.487380504861;12825.294608796607;12910.22538647684;13158.60524184276;13999;14870.182139982406;14945.02857314271;14989.175595342362;5525.392206857243;5737.512311453574;6093.360197179232;6426.550141490051;6545.887199176152;881.3433991676242;1022.437659287389;1036.9948150259352;1059.6291298045621;1178;23199.188028418925;26347.604785928226;28455.71949262288;29526.852365738036;29778;1103.4041617526607;1161.5005547614608;1166.1603645375317;1189.9766201067075;1252.1735654468189;12788.912942399815;13750.931245343909;14649.194294313915;14741.11553306805;15071.965284686647;524934;526068;531079;531338;534291;57815.71092144513;59071.40928590745;59499.405005950255;59538.70230648819;59730;1279.539365828301;1460.1385182742233;1466.633341664584;1480.9407623695147;1606.2450648195563;29206.56190157107;32106.35787284288;32292.70829166807;32319.545620446665;32617.34765304728;57761;57787.422125778205;58249.12626310693;58410.707946459996;58426;345210;353909;356799;356859;357283;45169.77415113035;45580.31629525626;46057.76971115123;46976;47021;47177.82055448641;48332.27501587409;48349.27476087932;48432.757836212004;48745;39804.60195398125;39855.2028959425;39956.60043399645;40557.1888562233;40930.1813963725;30383;36694.633053670186;38682.8395148146;38777.03057423587;39881.20237595174;35441.1139721509;36080.819595901856;36450.45324320084;38964;39481.2103757929;27877.721222788325;27897.605119743526;28578.285542861595;29648.407031859675;32119.678803211667;21845.235416760974;23407.725663364516;25122;25217.74782252154;25868.09461668908 05:20:41 INFO - PROCESS | 1981 | |2;jquery.html;354.3851417790132;359.7391890879113;360.3010160289039;371.94978677878476;372.22762767257944;19587.804121958776;19943.900280498594;21091.789082109175;21104.155833766632;21114.89442552787;10229.948850255738;11575.826362604568;11780.46987885545;12176.147669663127;12210.328431936263;4974.527419895113;5266.973665131669;5317.813876514323;5889.587728858982;5900.97049514754;5707.686077265748;5779.566532510057;5807.477327040566;5809.796657117002;5812.244408226946;4737.92893106602;5307.469253074701;5317.229001794737;5516.586256030793;5760.279965004374;5177.32694749682;5236.659617124875;5239.816606418776;5289.894202115975;5302.0721373759825;4071.877843664695;4721.787519561628;5055.949440505621;5114.232865070232;5114.667546609458;10278;13234.73530529384;13365.53220637273;13420.261885596288;13445.058845880792;1979.8119178678003;2019.121682068305;2027.0574183004826;2035.28764932274;2040.5714799892041;8894.599743011515;9166.541672916328;9786.217102631772;13527.729445411134;14203.78694319586;1709.6495218480181;1746.6506698660319;1749.9912500437545;1752.115181833179;1767.9027653479181;86406;87868.80327991788;104976.42535361975;106355.4682226584;107701.99999999921;9784.951075244579;10855.643044619423;10985.39580323074;11448.969592736694;11531.077513798877;13472.663183420296;13536.458541658223;13539;13544.187348759106;13567.25380104084;8601.870971935426;8622.439541429787;8641.395102342902;8660.95669521661;8687.956560217159;8879.712441695918;8899.110088991178;8899.510526921082;8947.597358118901;8958.328125390623;4492.595666390041;4535.575923651162;4539.887727506716;4560.863174104782;4589.862304130881;1912.2637784453086;1975.6740137877089;1980.633582787189;2005.4785755703622;2007.207153174488;782.6438970268514;854.2952064546649;863.1454859688863;900.6712549919363;952.8999455057119;19349.613007739765;19497.805021949884;19711;19726.915019674056;20004.299849505198;915.3546749541557;959.1846930109351;959.6353385713384;980.6616717232686;1072.0887245840972;8804.911950880409;10736.89263107359;10849.294795838245;10975.451227438596;10987.835182472269;613157;639793.8010310011;645683;663670;666473;119625;120780;122941;124256.37871810763;124581;978.7895602445508;980.7106903463496;1001.1590264178126;1001.7545701303227;1029.6550655530332;17639.735403968694;18140.365087221882;18372.632547348712;18568.164432600297;18573.628527429646;48144.51855481401;48150.036999259115;48759.512404875495;49278;49792.25311620256;47401.76299118482;54328.64178395414;67118.66440667765;67698.32301677117;71177;5576.721163941867;7850.882236766567;8099.676012959416;8116;8409.621567029377;7740.4581679284165;8792.868106978272;9000.009998899985;9294.767630809283;9402.965673776016;7965.880511792444;8153.714619988509;8240.876386854083;8524.190201930807;8705.260052895575;8185.263326300424;8197;8335.416520843482;8385.035720892176;8429.957850210709;8482.19419155204;8576.185262400062;8607.225349718556;8614.095519970313;8829.33779966518;11802.704932376759;12143.75712485763;12282.938585307016;12327.506899724269;12330.568430104904;8123.350131989545;8222.013358397031;8256.380771442286;8431.19903609156;8439.831203375776 05:20:41 INFO - PROCESS | 1981 | |3;mootools.html;1569.7409927361982;1588.9602759931004;1883.2090521980767;1974.5063734066484;1982.0981453438687;6685.364890335422;7330.303621155995;7864.646090925908;8864.246539044188;8890.199882010618;8569.400141990063;8574.44266122703;8674.479531228131;8694.56527173642;8705.608247628856;2445.6698345723275;2467.7408872068445;2469.7283298837115;2470.8393954392996;2492.1651246832243;2268.650153158868;2338.5089131282452;2377.762223777626;2464.6549483072295;2475.2450502596703;2452.9754702452924;2464.7904928081134;2476.616124500705;2494.87525623719;2499.200255918107;2413.625887987365;2423.6912067483536;2428.0651948999584;2441.523902838947;2451.240115564181;2456.5823809952353;2475.059477398595;2481.2184161988916;2483.3046746910895;2486.7761901428958;8886.200241978253;8894.4663320201;8895.955520222358;8914.554272286425;8942.73171804847;5446.019716451037;5547.362053363834;5565.860853478695;5569.303837020372;5587.692676902769;3599.3881040222964;3666.1934374437583;3727.9068023299365;3777.7166712496673;3779.433085037239;1043.3687618990477;1056.7622284985894;1059.53380512575;1067.8024565455416;1073.2111897755144;11793.233439826385;11967.461464234131;11973.281603103842;11978.401079945968;11988.940055299669;4167.874963751093;4848.12733707936;4855.6601037927;4913.164761990471;4976;10130;10179.389236645826;10181.440020798927;10197.796044079225;10202.540885660163;5449.809256676077;5544.805931792449;5548.278723765885;5569.443055694479;5605.187247849039;3626.3472574936764;3825.885223443301;4973.577245934136;4982.750862456863;5031.371078615173;3929.901752456154;3940.9802950985636;3990.20195960809;4026.617471340218;4027.033511957168;1144.2962578014628;1315.105728104898;1317.947282108705;1326.6550696818897;1332.5269529317147;1039.7244730146517;1072.785442911421;1087.4399684162663;1288.3300683644452;1368.7878378851294;8072.878906816402;8106.351491880753;8230.711925082593;8236.958815205886;8268.875966860502;460.78343178705956;498.62603047714214;501.0330062978414;510.31362817011063;514.7580637100557;6243.562950593506;6255.155554000152;6289.465395441439;6294.527910406738;6296.464800492009;10078.949605251926;10338.948305258426;10424.687259382079;10438.008389203014;10479.266451348485;9909.702708918743;10145.847812282822;10267.640632577824;10287.125594324416;10303.9484802577;8052.637631306605;8126.674933002732;8165.2243036911395;8200.794980125545;8241.587920603946;6770.593764374154;7903.091144518224;8043.557604331818;8045.919540804517;8264.380171487282;9389.765255868659;9503.382280152044;9586.28102892272;9609.807803844024;9659.855102173613;9631.807363852824;9827.508624568885;9856;9873.555689993824;9975.401475911469;5981.312149102909;6602.537822352389;7258.274172582699;7399.852002959803;7826.569538675428;7891.329237014918;7914.643841027052;7944.324732397811;7944.960275198819;7992.880106798519;7047.541909775849;7151.2133665297815;7154.427645788221;7333.889991650023;7356.190819010012;6935.895961560682;7031.859362812817;7102.893456598258;7109.822254443473;7210.711571537289;7459.776206713807;7589.848203036019;7600.3539699123985;7632.389408847168;7653.770386888402;6875.140607424072;6897.965510172417;6900.965495172492;6931.44548436134;6963.825904352431;6884.345987131214;6961;7046.471514636525;7063.364297213276;7078.2921707830865 05:20:41 INFO - PROCESS | 1981 | |4;prototype.html;328.1435453466452;330.3821853134639;332.37347599774415;335.8706897844329;337.94086034943894;6886.345797149275;6892.620905850183;6894.413974812147;6905.447564194865;6926.8614627707475;5942.6137301075505;6555.344465553442;6806.523543351967;6915.688794004269;6925.965370173155;4134.2144992451485;4926.3842019747535;5051.898962020758;5064.139096353629;5120.795168193277;4284.67864910133;4832.347633069543;5101.285819985205;5153.1754919212935;5178;4020.6984476164257;4335.371371151181;4713.269443236304;5056.747162641872;5057.797688092491;5047.394312682483;5055.317532133152;5073.315102461176;5086.084504789136;5093.414257360414;4348.673849461303;4349.499807522112;4358.411614432074;4368.301071828492;4380.693351465398;5344.465553444663;6398.13625160602;6526.510511711641;6696.397324240842;6712.295209003082;5911.586188966774;5972.402759723993;5980.521558275327;5997.310309314441;5997.940020599825;5143.434222235551;6625.536212465129;6834.726610935557;7349.301816327494;7362.5950572718475;4846.61227101831;4861.6353773467135;4862.051899879525;4862.708237505761;4870.902581948341;7711.03612048494;7795.181505941908;7813.140554539053;7829.882551761728;7868.606569671493;4548.003975321501;4751.263554149113;4831.685940413862;4911;4928.334674818853;5001.399832020181;5010.273510341053;5010.824621138243;5016.799328026911;5018.2974383586325;5880.353161152269;5881.735321910524;5886.970565147147;5886.999210134201;5902.61632993854;6070.3019152797115;7335.706571737178;7341.229170936975;7372.225916278713;7415.1843297237265;1446.1901335252292;1625.1792844613394;1741.8954862708279;1748.501677022068;1766.911654417274;1113.2374323588367;1124.5445594534226;1137.7610701752724;1138.7928795476655;1142.8857114288505;6776.322367763184;6788.321167883172;6791.66041697923;6794.150731158606;6805.4895882808;7649.464537482434;7650.1202361728;7662.9233707663325;7665.923340766521;7675.15573286938;6773.254941956381;6780.660966951633;6789.15135608049;6793.59238445685;6808.08090907731;3733.8506459741307;4052.8176232069627;4056.127932494528;4076.9184616307507;4080.8775736727944;7992.200779922077;8139.186081391814;8178.836423271501;8188.017437907489;8232.958835205785;6948.33990770876;8055.879161812461;8111.351091912751;8133.75598732039;8134.55259960696;8090.514569125989;8116.553589552631;8145.389095817837;8150.7147249845975;8157.265846073882;7495.287947644965;7817.0619525657285;7820.413468989962;7829.099653539915;7842.411819113703;7623.923760762544;7646.579438130733;7666.884996724942;7679.963204967258;7696.384289256958;6534.869302614016;8126.471779334324;8137.593120344078;8147.511149331059;8193.385496087698;4980.701157930535;4981.227909674007;4982.227754698028;4991.101601711727;4996.800127994985;6142.262928448615;6388.680565971776;7274.345308922222;7369.963150184215;7788.805279868048;6195.4424101831055;7352.4485663576515;7411.962940185264;7421.628918554159;7441;7404;7407.518511296748;7419.962900185465;7432.996545466292;7437.070366204224;5918.526517878646;6211.782587609412;6982.546134501241;7009.474289428212;7228.168760592599;6198.442140207403;7320.487565870338;7373.18894921569;7414.369778568882;7429.368503677248;7209.6395180241825;7221.277872212737;7221.855562888818;7230.927690723236;7248.383887369632 05:20:41 INFO - PROCESS | 1981 | |5;yui.html;681.843176069504;685.8422562810551;718.6514540447885;750.3996802557953;753.3483536740721;15131.62170945727;15364.923175384107;15472.767908481368;15475.767863482057;15502.22488875556;14204.28978551071;14271.71456570868;16053.277602507886;16289.592760181002;16353.591160221;754.1440465072155;930.9627614895396;934.042606328512;945.2013048973606;947.3652652722658;924.2929159193222;935.4153653966271;945.1304799584365;947.0813311088233;948.8529277961892;992.3599278465385;1002.7092143278477;1004.6031817432109;1006.6124542051326;1009.0061289629746;966.2559828931718;988.1798107570735;992.9702108936743;997.3816233934934;999.8050380175869;701.3197198717236;725.151572659989;728.4281838756604;738.9408847292203;744.6239648977232;15522;15570.14364209968;15717.449889253936;15747;15804.683906321809;12394.62816115518;12405.751884962341;12421.31682757448;12506.999440044865;12557.811632825515;9795.412275263507;9979.30144889858;10049.799004019878;10167.644132455402;10430.269881108325;3090.057532452601;3367.3770352484867;3414.2830005698834;3538.203904121552;3539.1152211947015;67517;67988;68117;76550;80769.59615201886;9254.86117708235;9294.721158365124;9320.487373194539;9434.198093162158;9447.055294470498;20778.584428311347;20782.27262045821;20788.27241046556;20808.37574872726;20878.582428351652;7456.739014134588;7549.169591344948;7559.357454616309;7564.205758395399;7661.387089032975;4100.835966561363;4178.582141785858;4181.351890456984;4183.895402614898;4184.707070505096;3543.875964341236;3572.392693242155;3591.964080359163;3598.2803439312243;3603.0271826606668;631.1983780598614;631.8104568629485;635.3995474276857;650.6746626686656;655.2006552006544;535.7053620508705;576.5589324167015;595.964242145464;596.7344531683359;618.5021058048225;6889.483288753364;8005.439619226599;8259.793505162299;8270.297024752843;8317.263853386536;465.8346287068042;516.6925679220858;547.1437200780765;568.7724910036019;569.8746275819313;3725.4784330193793;3727.2731817295366;3822.3502004659276;3951.8616848410165;4060.0864805419137;73062;77750.05624859424;81541.59229203816;83574.58212708897;84459;67478.98781518282;67995;70862.64568677227;72542.63728681323;73559;50226.74886625617;62290.75418491605;63128.05307920385;64009.679951599945;64911.02633460502;7815.648295826588;7833.09919359281;7881.369490440866;7897.68409263623;7913.86538986326;34016.82991585026;46903;47340.7632961833;47443;47564.52435475739;59555;62290.377096228454;62609.68695156677;62793.68603156955;62882.74234515193;9676.612935482503;9819.950900245452;9939.701808945743;10058.245631577514;10521.105706015074;9011.414258073204;10985.560577576807;11027.283226590245;11066.502007409525;11247.493862776031;10296.794064118825;10342.689719308433;10430.113440357654;10537.57849686004;10663.733406664895;10229.437380943822;10282.280240383101;10347.172226221734;11103.333799971704;11108.277961932448;10004.049615286536;10446.68659940203;10526.842097368393;10595.15238780911;10655.360678359324;8656.956715216384;8747.475151490931;8777.385583009129;8837.558122093998;8906.688265910661;8814;8891.866622000545;8933.642654293755;8963.282937364866;9022.458652480873 05:20:41 INFO - PROCESS | 1981 | __end_tp_report 05:20:41 INFO - PROCESS | 1981 | __start_cc_report 05:20:41 INFO - PROCESS | 1981 | _x_x_mozilla_cycle_collect,368 05:20:41 INFO - PROCESS | 1981 | __end_cc_report 05:20:41 INFO - PROCESS | 1981 | __startTimestamp1457356841035__endTimestamp 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - PROCESS | 1981 | ------- Summary: start ------- 05:20:41 INFO - PROCESS | 1981 | Number of tests: 6 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - PROCESS | 1981 | [#0] dojo.html Cycles:165 Average:5748.66 Median:6084.85 stddev:699.09 (11.5%) stddev-sans-first:664.65 05:20:41 INFO - PROCESS | 1981 | Values: 2903.4 2925.2 3041.8 3486.5 3563.9 4985.9 5546.6 5805.2 5836.2 5857.6 5686.7 5697.6 5794.5 5836.9 5941.9 5233.6 5235.8 5298.0 5298.2 5335.8 5280.8 5282.7 5305.5 5325.0 5332.0 5194.2 5225.1 5294.9 5307.8 5322.8 5234.1 5254.1 5273.8 5291.6 5349.1 4308.2 5225.8 5228.8 5279.2 5280.8 5622.4 5672.0 5724.5 5748.8 5755.7 6196.1 6229.8 6253.9 6274.3 6300.6 6144.9 6173.3 6224.6 6240.3 6249.8 5932.2 5944.8 5948.9 5953.5 5955.4 6320.3 6330.4 6334.3 6353.0 6367.8 6094.0 6136.8 6140.6 6154.3 6249.4 5330.3 6132.9 6147.0 6231.5 6244.1 6108.5 6231.6 6246.5 6249.5 6255.8 6104.8 6145.1 6152.8 6225.6 6247.4 4894.2 4937.3 4941.2 4947.5 4957.8 4437.6 4445.0 4451.8 4457.2 4473.2 5722.8 5753.8 5861.8 5865.9 5921.7 6176.0 6226.5 6247.4 6262.9 6266.8 5247.7 5869.4 5870.4 5871.9 5877.7 4371.0 4536.9 4970.3 5398.8 5459.4 6430.9 6477.4 6482.0 6513.2 6551.0 6126.8 6237.0 6271.3 6287.7 6289.8 6144.4 6464.9 6470.0 6476.7 6480.3 6176.6 6204.0 6217.4 6225.8 6281.9 6146.3 6159.1 6288.4 6297.2 6297.8 5264.8 6099.2 6101.4 6191.8 6213.7 6112.4 6169.9 6173.9 6183.0 6197.7 4758.9 5813.8 6035.9 6050.5 6095.2 6114.8 6150.1 6161.2 6183.9 6214.6 6082.5 6084.8 6105.7 6125.8 6136.9 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - PROCESS | 1981 | [#1] ext.html Cycles:180 Average:59043.93 Median:38865.02 stddev:119489.50 (307.4%) stddev-sans-first:119743.85 05:20:41 INFO - PROCESS | 1981 | Values: 500.4 511.9 531.9 561.4 595.9 37229.8 37795.1 37869.6 37944.0 37955.2 36814.4 38953.0 38999.0 39053.8 39130.2 9212.9 9321.3 9428.1 9442.6 9448.0 9310.6 9362.2 9438.7 9484.3 9494.8 9489.5 9496.4 9498.2 9565.5 9574.4 9482.1 9483.6 9564.4 9568.4 9576.4 9363.4 9414.2 9419.2 9518.8 9522.7 30371.7 38286.4 38431.0 38582.6 39039.8 2607.3 3026.7 3153.7 3207.8 3411.2 24997.3 25667.9 26779.3 27077.7 28351.9 2699.4 2762.2 2772.0 2808.3 2827.8 444167.0 446502.0 449816.0 450040.0 451629.0 45592.8 46128.8 46427.0 46476.0 62247.0 44955.0 45109.5 45140.1 45239.0 45513.0 15353.8 15620.0 15722.6 15731.4 15931.4 12629.4 12685.9 12815.5 12825.3 12910.2 13158.6 13999.0 14870.2 14945.0 14989.2 5525.4 5737.5 6093.4 6426.6 6545.9 881.3 1022.4 1037.0 1059.6 1178.0 23199.2 26347.6 28455.7 29526.9 29778.0 1103.4 1161.5 1166.2 1190.0 1252.2 12788.9 13750.9 14649.2 14741.1 15072.0 524934.0 526068.0 531079.0 531338.0 534291.0 57815.7 59071.4 59499.4 59538.7 59730.0 1279.5 1460.1 1466.6 1480.9 1606.2 29206.6 32106.4 32292.7 32319.5 32617.3 57761.0 57787.4 58249.1 58410.7 58426.0 345210.0 353909.0 356799.0 356859.0 357283.0 45169.8 45580.3 46057.8 46976.0 47021.0 47177.8 48332.3 48349.3 48432.8 48745.0 39804.6 39855.2 39956.6 40557.2 40930.2 30383.0 36694.6 38682.8 38777.0 39881.2 35441.1 36080.8 36450.5 38964.0 39481.2 27877.7 27897.6 28578.3 29648.4 32119.7 21845.2 23407.7 25122.0 25217.7 25868.1 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - PROCESS | 1981 | [#2] jquery.html Cycles:180 Average:34054.69 Median:27383.39 stddev:106961.07 (390.6%) stddev-sans-first:107231.19 05:20:41 INFO - PROCESS | 1981 | Values: 354.4 359.7 360.3 371.9 372.2 19587.8 19943.9 21091.8 21104.2 21114.9 10229.9 11575.8 11780.5 12176.1 12210.3 4974.5 5267.0 5317.8 5889.6 5901.0 5707.7 5779.6 5807.5 5809.8 5812.2 4737.9 5307.5 5317.2 5516.6 5760.3 5177.3 5236.7 5239.8 5289.9 5302.1 4071.9 4721.8 5055.9 5114.2 5114.7 10278.0 13234.7 13365.5 13420.3 13445.1 1979.8 2019.1 2027.1 2035.3 2040.6 8894.6 9166.5 9786.2 13527.7 14203.8 1709.6 1746.7 1750.0 1752.1 1767.9 86406.0 87868.8 104976.4 106355.5 107702.0 9785.0 10855.6 10985.4 11449.0 11531.1 13472.7 13536.5 13539.0 13544.2 13567.3 8601.9 8622.4 8641.4 8661.0 8688.0 8879.7 8899.1 8899.5 8947.6 8958.3 4492.6 4535.6 4539.9 4560.9 4589.9 1912.3 1975.7 1980.6 2005.5 2007.2 782.6 854.3 863.1 900.7 952.9 19349.6 19497.8 19711.0 19726.9 20004.3 915.4 959.2 959.6 980.7 1072.1 8804.9 10736.9 10849.3 10975.5 10987.8 613157.0 639793.8 645683.0 663670.0 666473.0 119625.0 120780.0 122941.0 124256.4 124581.0 978.8 980.7 1001.2 1001.8 1029.7 17639.7 18140.4 18372.6 18568.2 18573.6 48144.5 48150.0 48759.5 49278.0 49792.3 47401.8 54328.6 67118.7 67698.3 71177.0 5576.7 7850.9 8099.7 8116.0 8409.6 7740.5 8792.9 9000.0 9294.8 9403.0 7965.9 8153.7 8240.9 8524.2 8705.3 8185.3 8197.0 8335.4 8385.0 8430.0 8482.2 8576.2 8607.2 8614.1 8829.3 11802.7 12143.8 12282.9 12327.5 12330.6 8123.4 8222.0 8256.4 8431.2 8439.8 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - PROCESS | 1981 | [#3] mootools.html Cycles:180 Average:5965.47 Median:5497.31 stddev:3156.71 (57.4%) stddev-sans-first:3148.28 05:20:41 INFO - PROCESS | 1981 | Values: 1569.7 1589.0 1883.2 1974.5 1982.1 6685.4 7330.3 7864.6 8864.2 8890.2 8569.4 8574.4 8674.5 8694.6 8705.6 2445.7 2467.7 2469.7 2470.8 2492.2 2268.7 2338.5 2377.8 2464.7 2475.2 2453.0 2464.8 2476.6 2494.9 2499.2 2413.6 2423.7 2428.1 2441.5 2451.2 2456.6 2475.1 2481.2 2483.3 2486.8 8886.2 8894.5 8896.0 8914.6 8942.7 5446.0 5547.4 5565.9 5569.3 5587.7 3599.4 3666.2 3727.9 3777.7 3779.4 1043.4 1056.8 1059.5 1067.8 1073.2 11793.2 11967.5 11973.3 11978.4 11988.9 4167.9 4848.1 4855.7 4913.2 4976.0 10130.0 10179.4 10181.4 10197.8 10202.5 5449.8 5544.8 5548.3 5569.4 5605.2 3626.3 3825.9 4973.6 4982.8 5031.4 3929.9 3941.0 3990.2 4026.6 4027.0 1144.3 1315.1 1317.9 1326.7 1332.5 1039.7 1072.8 1087.4 1288.3 1368.8 8072.9 8106.4 8230.7 8237.0 8268.9 460.8 498.6 501.0 510.3 514.8 6243.6 6255.2 6289.5 6294.5 6296.5 10078.9 10338.9 10424.7 10438.0 10479.3 9909.7 10145.8 10267.6 10287.1 10303.9 8052.6 8126.7 8165.2 8200.8 8241.6 6770.6 7903.1 8043.6 8045.9 8264.4 9389.8 9503.4 9586.3 9609.8 9659.9 9631.8 9827.5 9856.0 9873.6 9975.4 5981.3 6602.5 7258.3 7399.9 7826.6 7891.3 7914.6 7944.3 7945.0 7992.9 7047.5 7151.2 7154.4 7333.9 7356.2 6935.9 7031.9 7102.9 7109.8 7210.7 7459.8 7589.8 7600.4 7632.4 7653.8 6875.1 6898.0 6901.0 6931.4 6963.8 6884.3 6961.0 7046.5 7063.4 7078.3 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - PROCESS | 1981 | [#4] prototype.html Cycles:180 Average:5977.48 Median:6704.35 stddev:1938.82 (28.9%) stddev-sans-first:1897.32 05:20:41 INFO - PROCESS | 1981 | Values: 328.1 330.4 332.4 335.9 337.9 6886.3 6892.6 6894.4 6905.4 6926.9 5942.6 6555.3 6806.5 6915.7 6926.0 4134.2 4926.4 5051.9 5064.1 5120.8 4284.7 4832.3 5101.3 5153.2 5178.0 4020.7 4335.4 4713.3 5056.7 5057.8 5047.4 5055.3 5073.3 5086.1 5093.4 4348.7 4349.5 4358.4 4368.3 4380.7 5344.5 6398.1 6526.5 6696.4 6712.3 5911.6 5972.4 5980.5 5997.3 5997.9 5143.4 6625.5 6834.7 7349.3 7362.6 4846.6 4861.6 4862.1 4862.7 4870.9 7711.0 7795.2 7813.1 7829.9 7868.6 4548.0 4751.3 4831.7 4911.0 4928.3 5001.4 5010.3 5010.8 5016.8 5018.3 5880.4 5881.7 5887.0 5887.0 5902.6 6070.3 7335.7 7341.2 7372.2 7415.2 1446.2 1625.2 1741.9 1748.5 1766.9 1113.2 1124.5 1137.8 1138.8 1142.9 6776.3 6788.3 6791.7 6794.2 6805.5 7649.5 7650.1 7662.9 7665.9 7675.2 6773.3 6780.7 6789.2 6793.6 6808.1 3733.9 4052.8 4056.1 4076.9 4080.9 7992.2 8139.2 8178.8 8188.0 8233.0 6948.3 8055.9 8111.4 8133.8 8134.6 8090.5 8116.6 8145.4 8150.7 8157.3 7495.3 7817.1 7820.4 7829.1 7842.4 7623.9 7646.6 7666.9 7680.0 7696.4 6534.9 8126.5 8137.6 8147.5 8193.4 4980.7 4981.2 4982.2 4991.1 4996.8 6142.3 6388.7 7274.3 7370.0 7788.8 6195.4 7352.4 7412.0 7421.6 7441.0 7404.0 7407.5 7420.0 7433.0 7437.1 5918.5 6211.8 6982.5 7009.5 7228.2 6198.4 7320.5 7373.2 7414.4 7429.4 7209.6 7221.3 7221.9 7230.9 7248.4 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - PROCESS | 1981 | [#5] yui.html Cycles:180 Average:16801.29 Median:62290.57 stddev:22757.25 (36.5%) stddev-sans-first:22788.90 05:20:41 INFO - PROCESS | 1981 | Values: 681.8 685.8 718.7 750.4 753.3 15131.6 15364.9 15472.8 15475.8 15502.2 14204.3 14271.7 16053.3 16289.6 16353.6 754.1 931.0 934.0 945.2 947.4 924.3 935.4 945.1 947.1 948.9 992.4 1002.7 1004.6 1006.6 1009.0 966.3 988.2 993.0 997.4 999.8 701.3 725.2 728.4 738.9 744.6 15522.0 15570.1 15717.4 15747.0 15804.7 12394.6 12405.8 12421.3 12507.0 12557.8 9795.4 9979.3 10049.8 10167.6 10430.3 3090.1 3367.4 3414.3 3538.2 3539.1 67517.0 67988.0 68117.0 76550.0 80769.6 9254.9 9294.7 9320.5 9434.2 9447.1 20778.6 20782.3 20788.3 20808.4 20878.6 7456.7 7549.2 7559.4 7564.2 7661.4 4100.8 4178.6 4181.4 4183.9 4184.7 3543.9 3572.4 3592.0 3598.3 3603.0 631.2 631.8 635.4 650.7 655.2 535.7 576.6 596.0 596.7 618.5 6889.5 8005.4 8259.8 8270.3 8317.3 465.8 516.7 547.1 568.8 569.9 3725.5 3727.3 3822.4 3951.9 4060.1 73062.0 77750.1 81541.6 83574.6 84459.0 67479.0 67995.0 70862.6 72542.6 73559.0 50226.7 62290.8 63128.1 64009.7 64911.0 7815.6 7833.1 7881.4 7897.7 7913.9 34016.8 46903.0 47340.8 47443.0 47564.5 59555.0 62290.4 62609.7 62793.7 62882.7 9676.6 9820.0 9939.7 10058.2 10521.1 9011.4 10985.6 11027.3 11066.5 11247.5 10296.8 10342.7 10430.1 10537.6 10663.7 10229.4 10282.3 10347.2 11103.3 11108.3 10004.0 10446.7 10526.8 10595.2 10655.4 8657.0 8747.5 8777.4 8837.6 8906.7 8814.0 8891.9 8933.6 8963.3 9022.5 05:20:41 INFO - PROCESS | 1981 | -------- Summary: end -------- 05:20:41 INFO - PROCESS | 1981 | 05:20:41 INFO - TEST-INFO | 1981: exit 0 05:20:41 INFO - TEST-OK | dromaeo_css | took 1110978ms 05:20:41 INFO - TEST-START | kraken 05:20:41 INFO - operating with platform_type : mac_ 05:20:41 INFO - Initialising browser for kraken test... 05:20:41 INFO - TEST-INFO | started process 1986 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/tmp6UGvwy/profile http://localhost:51915/getInfo.html) 05:20:44 INFO - PROCESS | 1986 | __metrics Screen width/height:1600/1200 05:20:44 INFO - PROCESS | 1986 | colorDepth:24 05:20:44 INFO - PROCESS | 1986 | Browser inner width/height: 1024/689 05:20:44 INFO - PROCESS | 1986 | __metrics 05:20:44 ERROR - PROCESS | 1986 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 05:20:45 INFO - TEST-INFO | 1986: exit 0 05:20:45 INFO - Browser initialized. 05:20:45 INFO - Running cycle 1/1 for kraken test... 05:20:45 INFO - TEST-INFO | started process 1989 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/T/tmp6UGvwy/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:20:57 INFO - PROCESS | 1989 | RSS: Main: 256389120 05:20:57 INFO - PROCESS | 1989 | 05:20:59 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51915/tests/kraken/driver.html?testName=audio-beat-detection) 05:21:00 INFO - PROCESS | 1989 | RSS: Main: 268840960 05:21:00 INFO - PROCESS | 1989 | 05:21:02 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51915/tests/kraken/driver.html?testName=audio-dft) 05:21:03 INFO - PROCESS | 1989 | RSS: Main: 276705280 05:21:03 INFO - PROCESS | 1989 | 05:21:06 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51915/tests/kraken/driver.html?testName=audio-fft) 05:21:07 INFO - PROCESS | 1989 | RSS: Main: 280739840 05:21:07 INFO - PROCESS | 1989 | 05:21:09 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51915/tests/kraken/driver.html?testName=audio-oscillator) 05:21:10 INFO - PROCESS | 1989 | RSS: Main: 280956928 05:21:10 INFO - PROCESS | 1989 | 05:21:12 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51915/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:21:12 INFO - PROCESS | 1989 | RSS: Main: 283791360 05:21:12 INFO - PROCESS | 1989 | 05:21:15 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51915/tests/kraken/driver.html?testName=imaging-darkroom) 05:21:15 INFO - PROCESS | 1989 | RSS: Main: 282877952 05:21:15 INFO - PROCESS | 1989 | 05:21:18 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51915/tests/kraken/driver.html?testName=imaging-desaturate) 05:21:19 INFO - PROCESS | 1989 | RSS: Main: 283807744 05:21:19 INFO - PROCESS | 1989 | 05:21:22 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51915/tests/kraken/driver.html?testName=json-parse-financial) 05:21:22 INFO - PROCESS | 1989 | RSS: Main: 283361280 05:21:22 INFO - PROCESS | 1989 | 05:21:24 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51915/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:21:24 INFO - PROCESS | 1989 | RSS: Main: 282021888 05:21:24 INFO - PROCESS | 1989 | 05:21:26 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51915/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:21:27 INFO - PROCESS | 1989 | RSS: Main: 282451968 05:21:27 INFO - PROCESS | 1989 | 05:21:29 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51915/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:21:30 INFO - PROCESS | 1989 | RSS: Main: 283967488 05:21:30 INFO - PROCESS | 1989 | 05:21:32 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51915/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:21:33 INFO - PROCESS | 1989 | RSS: Main: 282124288 05:21:33 INFO - PROCESS | 1989 | 05:21:36 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51915/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:21:36 INFO - PROCESS | 1989 | RSS: Main: 282259456 05:21:36 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | Cycle 1(1): loaded http://localhost:51915/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51915/tests/kraken/driver.html?testName=ai-astar) 05:21:38 INFO - PROCESS | 1989 | RSS: Main: 284618752 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | __start_tp_report 05:21:38 INFO - PROCESS | 1989 | _x_x_mozilla_page_load 05:21:38 INFO - PROCESS | 1989 | _x_x_mozilla_page_load_details 05:21:38 INFO - PROCESS | 1989 | |i|pagename|runs| 05:21:38 INFO - PROCESS | 1989 | |0;ai-astar;112;109;115;114;115;126;111;115;116;114 05:21:38 INFO - PROCESS | 1989 | |1;audio-beat-detection;147;123;139;153;127;184;170;158;162;126 05:21:38 INFO - PROCESS | 1989 | |2;audio-dft;201;201;197;203;207;214;261;240;204;197 05:21:38 INFO - PROCESS | 1989 | |3;audio-fft;59;61;73;83;72;133;55;59;68;84 05:21:38 INFO - PROCESS | 1989 | |4;audio-oscillator;84;82;127;79;83;80;120;80;83;119 05:21:38 INFO - PROCESS | 1989 | |5;imaging-gaussian-blur;92;89;91;88;90;87;90;88;91;86 05:21:38 INFO - PROCESS | 1989 | |6;imaging-darkroom;104;95;96;94;96;95;95;120;95;96 05:21:38 INFO - PROCESS | 1989 | |7;imaging-desaturate;92;90;90;91;94;76;77;138;77;107 05:21:38 INFO - PROCESS | 1989 | |8;json-parse-financial;56;57;55;57;55;58;56;63;56;54 05:21:38 INFO - PROCESS | 1989 | |9;json-stringify-tinderbox;70;68;73;68;75;75;69;72;71;70 05:21:38 INFO - PROCESS | 1989 | |10;stanford-crypto-aes;99;108;92;88;86;83;87;86;85;83 05:21:38 INFO - PROCESS | 1989 | |11;stanford-crypto-ccm;136;124;131;128;137;129;123;131;135;121 05:21:38 INFO - PROCESS | 1989 | |12;stanford-crypto-pbkdf2;149;141;128;157;181;189;140;136;140;142 05:21:38 INFO - PROCESS | 1989 | |13;stanford-crypto-sha256-iterative;69;67;69;69;67;96;96;97;71;69 05:21:38 INFO - PROCESS | 1989 | __end_tp_report 05:21:38 INFO - PROCESS | 1989 | __start_cc_report 05:21:38 INFO - PROCESS | 1989 | _x_x_mozilla_cycle_collect,949 05:21:38 INFO - PROCESS | 1989 | __end_cc_report 05:21:38 INFO - PROCESS | 1989 | __startTimestamp1457356898670__endTimestamp 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | ------- Summary: start ------- 05:21:38 INFO - PROCESS | 1989 | Number of tests: 14 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#0] ai-astar Cycles:10 Average:114.70 Median:115.00 stddev:4.52 (3.9%) stddev-sans-first:4.69 05:21:38 INFO - PROCESS | 1989 | Values: 112.0 109.0 115.0 114.0 115.0 126.0 111.0 115.0 116.0 114.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#1] audio-beat-detection Cycles:10 Average:148.90 Median:155.50 stddev:20.34 (13.1%) stddev-sans-first:21.57 05:21:38 INFO - PROCESS | 1989 | Values: 147.0 123.0 139.0 153.0 127.0 184.0 170.0 158.0 162.0 126.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#2] audio-dft Cycles:10 Average:212.50 Median:205.50 stddev:21.21 (10.3%) stddev-sans-first:22.08 05:21:38 INFO - PROCESS | 1989 | Values: 201.0 201.0 197.0 203.0 207.0 214.0 261.0 240.0 204.0 197.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#3] audio-fft Cycles:10 Average:74.70 Median:70.00 stddev:22.80 (32.6%) stddev-sans-first:23.46 05:21:38 INFO - PROCESS | 1989 | Values: 59.0 61.0 73.0 83.0 72.0 133.0 55.0 59.0 68.0 84.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#4] audio-oscillator Cycles:10 Average:93.70 Median:81.00 stddev:19.70 (24.3%) stddev-sans-first:20.58 05:21:38 INFO - PROCESS | 1989 | Values: 84.0 82.0 127.0 79.0 83.0 80.0 120.0 80.0 83.0 119.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#5] imaging-gaussian-blur Cycles:10 Average:89.20 Median:90.00 stddev:1.93 (2.1%) stddev-sans-first:1.76 05:21:38 INFO - PROCESS | 1989 | Values: 92.0 89.0 91.0 88.0 90.0 87.0 90.0 88.0 91.0 86.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#6] imaging-darkroom Cycles:10 Average:98.60 Median:95.00 stddev:8.03 (8.5%) stddev-sans-first:8.28 05:21:38 INFO - PROCESS | 1989 | Values: 104.0 95.0 96.0 94.0 96.0 95.0 95.0 120.0 95.0 96.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#7] imaging-desaturate Cycles:10 Average:93.20 Median:90.00 stddev:18.40 (20.4%) stddev-sans-first:19.51 05:21:38 INFO - PROCESS | 1989 | Values: 92.0 90.0 90.0 91.0 94.0 76.0 77.0 138.0 77.0 107.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#8] json-parse-financial Cycles:10 Average:56.70 Median:56.50 stddev:2.50 (4.4%) stddev-sans-first:2.64 05:21:38 INFO - PROCESS | 1989 | Values: 56.0 57.0 55.0 57.0 55.0 58.0 56.0 63.0 56.0 54.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#9] json-stringify-tinderbox Cycles:10 Average:71.10 Median:71.50 stddev:2.60 (3.6%) stddev-sans-first:2.73 05:21:38 INFO - PROCESS | 1989 | Values: 70.0 68.0 73.0 68.0 75.0 75.0 69.0 72.0 71.0 70.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#10] stanford-crypto-aes Cycles:10 Average:89.70 Median:86.50 stddev:8.00 (9.2%) stddev-sans-first:7.75 05:21:38 INFO - PROCESS | 1989 | Values: 99.0 108.0 92.0 88.0 86.0 83.0 87.0 86.0 85.0 83.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#11] stanford-crypto-ccm Cycles:10 Average:129.50 Median:131.00 stddev:5.58 (4.3%) stddev-sans-first:5.40 05:21:38 INFO - PROCESS | 1989 | Values: 136.0 124.0 131.0 128.0 137.0 129.0 123.0 131.0 135.0 121.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.30 Median:145.50 stddev:19.88 (13.7%) stddev-sans-first:21.08 05:21:38 INFO - PROCESS | 1989 | Values: 149.0 141.0 128.0 157.0 181.0 189.0 140.0 136.0 140.0 142.0 05:21:38 INFO - PROCESS | 1989 | 05:21:38 INFO - PROCESS | 1989 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:77.00 Median:70.00 stddev:13.39 (19.1%) stddev-sans-first:13.89 05:21:38 INFO - PROCESS | 1989 | Values: 69.0 67.0 69.0 69.0 67.0 96.0 96.0 97.0 71.0 69.0 05:21:38 INFO - PROCESS | 1989 | -------- Summary: end -------- 05:21:38 INFO - PROCESS | 1989 | 05:21:39 INFO - TEST-INFO | 1989: exit 0 05:21:39 INFO - TEST-OK | kraken | took 57878ms 05:21:39 INFO - SUITE-END | took 1168s 05:21:39 INFO - Completed test suite (00:19:29) 05:21:39 INFO - javascript benchmark 05:21:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2903.448344814485, 2925.195571217916, 3041.7718671099674, 3486.4944583035453, 3563.8574457021705, 4985.850424487262, 5546.5562754979655, 5805.24531810865, 5836.182934389189, 5857.648541087532, 5686.658800471974, 5697.6296540724825, 5794.507466865311, 5836.9124463133085, 5941.910871336922, 5233.555147812431, 5235.842924712265, 5298.046351656701, 5298.205269209611, 5335.759890804904, 5280.841574752744, 5282.709450980195, 5305.495977882114, 5324.973375133139, 5332.040232758121, 5194.194899790538, 5225.111731005719, 5294.947050529484, 5307.840764777063, 5322.813701520467, 5234.0840352938085, 5254.0805359062015, 5273.789048438058, 5291.603129765283, 5349.090654588729, 4308.224519586473, 5225.790968361261, 5228.764705588258, 5279.1817268323475, 5280.762365693553, 5622.381538030813, 5671.9716401418145, 5724.542036637101, 5748.827535173951, 5755.712214389264, 6196.101565273055, 6229.781957631507, 6253.874922501524, 6274.341194174637, 6300.621962682208, 6144.893919094561, 6173.259208894961, 6224.564280500367, 6240.31356550779, 6249.75000999964, 5932.228810254683, 5944.762209511571, 5948.85127871798, 5953.493953013999, 5955.43423374783, 6320.302622965617, 6330.3669633036325, 6334.334894836068, 6352.968235158887, 6367.808965731036, 6093.969530152321, 6136.754529818846, 6140.596275277727, 6154.323024467305, 6249.375062493805, 5330.307060082242, 6132.908006379907, 6146.969265153645, 6231.532635052389, 6244.094606282064, 6108.480779133734, 6231.563790534619, 6246.531510136758, 6249.531285153541, 6255.78104766331, 6104.822969073627, 6145.125736650364, 6152.753889844445, 6225.6264624121795, 6247.406496382836, 4894.19245824435, 4937.308776771255, 4941.160002799461, 4947.505249475023, 4957.801687932514, 4437.556244375537, 4445.022095139129, 4451.755153466591, 4457.175422546774, 4473.194824931478, 5722.799702010409, 5753.827385178452, 5861.824145275648, 5865.912011319833, 5921.703914804242, 6175.980963141032, 6226.533010024266, 6247.375262473807, 6262.937370626236, 6266.780662676784, 5247.685138891678, 5869.413058694096, 5870.442307980735, 5871.911921321183, 5877.735501902424, 4370.972821386971, 4536.88657783558, 4970.254461830755, 5398.838034858961, 5459.372172200168, 6430.935690643128, 6477.4170324671, 6481.999999999905, 6513.185851768529, 6550.967245163743, 6126.761967422386, 6236.975216230163, 6271.341509141657, 6287.717052732546, 6289.811305660837, 6144.354842741448, 6464.935350646621, 6470.0294955755135, 6476.676166191766, 6480.287168411377, 6176.567640265318, 6204.007358822567, 6217.409346112112, 6225.782097626561, 6281.937180628135, 6146.323904370426, 6159.076138579249, 6288.402601752826, 6297.1813664223355, 6297.779577714758, 5264.815731449381, 6099.176611157437, 6101.429060711369, 6191.752329906753, 6213.689315534296, 6112.419320164578, 6169.907451388322, 6173.9073913892225, 6183.0, 6197.690115494297, 4758.857234282977, 5813.82558523245, 6035.909461358171, 6050.515958723204, 6095.238095238095, 6114.814446323713, 6150.077488376601, 6161.199044124235, 6183.855986642486, 6214.5960512566535, 6082.452579267887, 6084.847878802888, 6105.737880364195, 6125.815438131457, 6136.85608443425], "unit": "score", "name": "dojo.html", "value": 5700.998246970048}, {"lowerIsBetter": false, "replicates": [500.3895247797688, 511.9308893299403, 531.9255104688532, 561.4049107945577, 595.8927393069246, 37229.81385093074, 37795.055123621925, 37869.62130378695, 37944.0, 37955.240895182076, 36814.44778328327, 38953.0, 38999.0, 39053.80473097638, 39130.217395652144, 9212.861807072883, 9321.347505674605, 9428.10433008863, 9442.575084121198, 9447.952760236189, 9310.581023853943, 9362.204212641933, 9438.669646562372, 9484.288678349118, 9494.81010379792, 9489.478078705668, 9496.43021418717, 9498.19265362445, 9565.473898935556, 9574.377665451759, 9482.051794820498, 9483.573239204252, 9564.426134431957, 9568.37805542641, 9576.377535460242, 9363.391379560375, 9414.246860251164, 9419.199368053723, 9518.809623807485, 9522.666706665303, 30371.69628303733, 38286.42570361447, 38431.0, 38582.61417385846, 39039.8048009761, 2607.2699644099494, 3026.742726868219, 3153.6530981592005, 3207.8075315481146, 3411.1642647551507, 24997.250082497554, 25667.871660641576, 26779.33051673704, 27077.729222707716, 28351.86592536296, 2699.433119045003, 2762.240383894445, 2772.0, 2808.2979255186206, 2827.816191947517, 444167.0, 446502.0, 449816.0, 450040.0, 451629.0, 45592.772036139606, 46128.76935615367, 46427.0, 46476.0, 62247.0, 44955.0, 45109.54890451119, 45140.09719805585, 45239.0, 45513.0, 15353.846461535464, 15620.0, 15722.606934826492, 15731.44939927097, 15931.36274549005, 12629.368531573567, 12685.921696655887, 12815.487380504861, 12825.294608796607, 12910.22538647684, 13158.60524184276, 13999.0, 14870.182139982406, 14945.02857314271, 14989.175595342362, 5525.392206857243, 5737.512311453574, 6093.360197179232, 6426.550141490051, 6545.887199176152, 881.3433991676242, 1022.437659287389, 1036.9948150259352, 1059.6291298045621, 1178.0, 23199.188028418925, 26347.604785928226, 28455.71949262288, 29526.852365738036, 29778.0, 1103.4041617526607, 1161.5005547614608, 1166.1603645375317, 1189.9766201067075, 1252.1735654468189, 12788.912942399815, 13750.931245343909, 14649.194294313915, 14741.11553306805, 15071.965284686647, 524934.0, 526068.0, 531079.0, 531338.0, 534291.0, 57815.71092144513, 59071.40928590745, 59499.405005950255, 59538.70230648819, 59730.0, 1279.539365828301, 1460.1385182742233, 1466.633341664584, 1480.9407623695147, 1606.2450648195563, 29206.56190157107, 32106.35787284288, 32292.70829166807, 32319.545620446665, 32617.34765304728, 57761.0, 57787.422125778205, 58249.12626310693, 58410.707946459996, 58426.0, 345210.0, 353909.0, 356799.0, 356859.0, 357283.0, 45169.77415113035, 45580.31629525626, 46057.76971115123, 46976.0, 47021.0, 47177.82055448641, 48332.27501587409, 48349.27476087932, 48432.757836212004, 48745.0, 39804.60195398125, 39855.2028959425, 39956.60043399645, 40557.1888562233, 40930.1813963725, 30383.0, 36694.633053670186, 38682.8395148146, 38777.03057423587, 39881.20237595174, 35441.1139721509, 36080.819595901856, 36450.45324320084, 38964.0, 39481.2103757929, 27877.721222788325, 27897.605119743526, 28578.285542861595, 29648.407031859675, 32119.678803211667, 21845.235416760974, 23407.725663364516, 25122.0, 25217.74782252154, 25868.09461668908], "unit": "score", "name": "ext.html", "value": 19000.67753314912}, {"lowerIsBetter": false, "replicates": [354.3851417790132, 359.7391890879113, 360.3010160289039, 371.94978677878476, 372.22762767257944, 19587.804121958776, 19943.900280498594, 21091.789082109175, 21104.155833766632, 21114.89442552787, 10229.948850255738, 11575.826362604568, 11780.46987885545, 12176.147669663127, 12210.328431936263, 4974.527419895113, 5266.973665131669, 5317.813876514323, 5889.587728858982, 5900.97049514754, 5707.686077265748, 5779.566532510057, 5807.477327040566, 5809.796657117002, 5812.244408226946, 4737.92893106602, 5307.469253074701, 5317.229001794737, 5516.586256030793, 5760.279965004374, 5177.32694749682, 5236.659617124875, 5239.816606418776, 5289.894202115975, 5302.0721373759825, 4071.877843664695, 4721.787519561628, 5055.949440505621, 5114.232865070232, 5114.667546609458, 10278.0, 13234.73530529384, 13365.53220637273, 13420.261885596288, 13445.058845880792, 1979.8119178678003, 2019.121682068305, 2027.0574183004826, 2035.28764932274, 2040.5714799892041, 8894.599743011515, 9166.541672916328, 9786.217102631772, 13527.729445411134, 14203.78694319586, 1709.6495218480181, 1746.6506698660319, 1749.9912500437545, 1752.115181833179, 1767.9027653479181, 86406.0, 87868.80327991788, 104976.42535361975, 106355.4682226584, 107701.99999999921, 9784.951075244579, 10855.643044619423, 10985.39580323074, 11448.969592736694, 11531.077513798877, 13472.663183420296, 13536.458541658223, 13539.0, 13544.187348759106, 13567.25380104084, 8601.870971935426, 8622.439541429787, 8641.395102342902, 8660.95669521661, 8687.956560217159, 8879.712441695918, 8899.110088991178, 8899.510526921082, 8947.597358118901, 8958.328125390623, 4492.595666390041, 4535.575923651162, 4539.887727506716, 4560.863174104782, 4589.862304130881, 1912.2637784453086, 1975.6740137877089, 1980.633582787189, 2005.4785755703622, 2007.207153174488, 782.6438970268514, 854.2952064546649, 863.1454859688863, 900.6712549919363, 952.8999455057119, 19349.613007739765, 19497.805021949884, 19711.0, 19726.915019674056, 20004.299849505198, 915.3546749541557, 959.1846930109351, 959.6353385713384, 980.6616717232686, 1072.0887245840972, 8804.911950880409, 10736.89263107359, 10849.294795838245, 10975.451227438596, 10987.835182472269, 613157.0, 639793.8010310011, 645683.0, 663670.0, 666473.0, 119625.0, 120780.0, 122941.0, 124256.37871810763, 124581.0, 978.7895602445508, 980.7106903463496, 1001.1590264178126, 1001.7545701303227, 1029.6550655530332, 17639.735403968694, 18140.365087221882, 18372.632547348712, 18568.164432600297, 18573.628527429646, 48144.51855481401, 48150.036999259115, 48759.512404875495, 49278.0, 49792.25311620256, 47401.76299118482, 54328.64178395414, 67118.66440667765, 67698.32301677117, 71177.0, 5576.721163941867, 7850.882236766567, 8099.676012959416, 8116.0, 8409.621567029377, 7740.4581679284165, 8792.868106978272, 9000.009998899985, 9294.767630809283, 9402.965673776016, 7965.880511792444, 8153.714619988509, 8240.876386854083, 8524.190201930807, 8705.260052895575, 8185.263326300424, 8197.0, 8335.416520843482, 8385.035720892176, 8429.957850210709, 8482.19419155204, 8576.185262400062, 8607.225349718556, 8614.095519970313, 8829.33779966518, 11802.704932376759, 12143.75712485763, 12282.938585307016, 12327.506899724269, 12330.568430104904, 8123.350131989545, 8222.013358397031, 8256.380771442286, 8431.19903609156, 8439.831203375776], "unit": "score", "name": "jquery.html", "value": 8665.542995775737}, {"lowerIsBetter": false, "replicates": [1569.7409927361982, 1588.9602759931004, 1883.2090521980767, 1974.5063734066484, 1982.0981453438687, 6685.364890335422, 7330.303621155995, 7864.646090925908, 8864.246539044188, 8890.199882010618, 8569.400141990063, 8574.44266122703, 8674.479531228131, 8694.56527173642, 8705.608247628856, 2445.6698345723275, 2467.7408872068445, 2469.7283298837115, 2470.8393954392996, 2492.1651246832243, 2268.650153158868, 2338.5089131282452, 2377.762223777626, 2464.6549483072295, 2475.2450502596703, 2452.9754702452924, 2464.7904928081134, 2476.616124500705, 2494.87525623719, 2499.200255918107, 2413.625887987365, 2423.6912067483536, 2428.0651948999584, 2441.523902838947, 2451.240115564181, 2456.5823809952353, 2475.059477398595, 2481.2184161988916, 2483.3046746910895, 2486.7761901428958, 8886.200241978253, 8894.4663320201, 8895.955520222358, 8914.554272286425, 8942.73171804847, 5446.019716451037, 5547.362053363834, 5565.860853478695, 5569.303837020372, 5587.692676902769, 3599.3881040222964, 3666.1934374437583, 3727.9068023299365, 3777.7166712496673, 3779.433085037239, 1043.3687618990477, 1056.7622284985894, 1059.53380512575, 1067.8024565455416, 1073.2111897755144, 11793.233439826385, 11967.461464234131, 11973.281603103842, 11978.401079945968, 11988.940055299669, 4167.874963751093, 4848.12733707936, 4855.6601037927, 4913.164761990471, 4976.0, 10130.0, 10179.389236645826, 10181.440020798927, 10197.796044079225, 10202.540885660163, 5449.809256676077, 5544.805931792449, 5548.278723765885, 5569.443055694479, 5605.187247849039, 3626.3472574936764, 3825.885223443301, 4973.577245934136, 4982.750862456863, 5031.371078615173, 3929.901752456154, 3940.9802950985636, 3990.20195960809, 4026.617471340218, 4027.033511957168, 1144.2962578014628, 1315.105728104898, 1317.947282108705, 1326.6550696818897, 1332.5269529317147, 1039.7244730146517, 1072.785442911421, 1087.4399684162663, 1288.3300683644452, 1368.7878378851294, 8072.878906816402, 8106.351491880753, 8230.711925082593, 8236.958815205886, 8268.875966860502, 460.78343178705956, 498.62603047714214, 501.0330062978414, 510.31362817011063, 514.7580637100557, 6243.562950593506, 6255.155554000152, 6289.465395441439, 6294.527910406738, 6296.464800492009, 10078.949605251926, 10338.948305258426, 10424.687259382079, 10438.008389203014, 10479.266451348485, 9909.702708918743, 10145.847812282822, 10267.640632577824, 10287.125594324416, 10303.9484802577, 8052.637631306605, 8126.674933002732, 8165.2243036911395, 8200.794980125545, 8241.587920603946, 6770.593764374154, 7903.091144518224, 8043.557604331818, 8045.919540804517, 8264.380171487282, 9389.765255868659, 9503.382280152044, 9586.28102892272, 9609.807803844024, 9659.855102173613, 9631.807363852824, 9827.508624568885, 9856.0, 9873.555689993824, 9975.401475911469, 5981.312149102909, 6602.537822352389, 7258.274172582699, 7399.852002959803, 7826.569538675428, 7891.329237014918, 7914.643841027052, 7944.324732397811, 7944.960275198819, 7992.880106798519, 7047.541909775849, 7151.2133665297815, 7154.427645788221, 7333.889991650023, 7356.190819010012, 6935.895961560682, 7031.859362812817, 7102.893456598258, 7109.822254443473, 7210.711571537289, 7459.776206713807, 7589.848203036019, 7600.3539699123985, 7632.389408847168, 7653.770386888402, 6875.140607424072, 6897.965510172417, 6900.965495172492, 6931.44548436134, 6963.825904352431, 6884.345987131214, 6961.0, 7046.471514636525, 7063.364297213276, 7078.2921707830865], "unit": "score", "name": "mootools.html", "value": 4788.098257052169}, {"lowerIsBetter": false, "replicates": [328.1435453466452, 330.3821853134639, 332.37347599774415, 335.8706897844329, 337.94086034943894, 6886.345797149275, 6892.620905850183, 6894.413974812147, 6905.447564194865, 6926.8614627707475, 5942.6137301075505, 6555.344465553442, 6806.523543351967, 6915.688794004269, 6925.965370173155, 4134.2144992451485, 4926.3842019747535, 5051.898962020758, 5064.139096353629, 5120.795168193277, 4284.67864910133, 4832.347633069543, 5101.285819985205, 5153.1754919212935, 5178.0, 4020.6984476164257, 4335.371371151181, 4713.269443236304, 5056.747162641872, 5057.797688092491, 5047.394312682483, 5055.317532133152, 5073.315102461176, 5086.084504789136, 5093.414257360414, 4348.673849461303, 4349.499807522112, 4358.411614432074, 4368.301071828492, 4380.693351465398, 5344.465553444663, 6398.13625160602, 6526.510511711641, 6696.397324240842, 6712.295209003082, 5911.586188966774, 5972.402759723993, 5980.521558275327, 5997.310309314441, 5997.940020599825, 5143.434222235551, 6625.536212465129, 6834.726610935557, 7349.301816327494, 7362.5950572718475, 4846.61227101831, 4861.6353773467135, 4862.051899879525, 4862.708237505761, 4870.902581948341, 7711.03612048494, 7795.181505941908, 7813.140554539053, 7829.882551761728, 7868.606569671493, 4548.003975321501, 4751.263554149113, 4831.685940413862, 4911.0, 4928.334674818853, 5001.399832020181, 5010.273510341053, 5010.824621138243, 5016.799328026911, 5018.2974383586325, 5880.353161152269, 5881.735321910524, 5886.970565147147, 5886.999210134201, 5902.61632993854, 6070.3019152797115, 7335.706571737178, 7341.229170936975, 7372.225916278713, 7415.1843297237265, 1446.1901335252292, 1625.1792844613394, 1741.8954862708279, 1748.501677022068, 1766.911654417274, 1113.2374323588367, 1124.5445594534226, 1137.7610701752724, 1138.7928795476655, 1142.8857114288505, 6776.322367763184, 6788.321167883172, 6791.66041697923, 6794.150731158606, 6805.4895882808, 7649.464537482434, 7650.1202361728, 7662.9233707663325, 7665.923340766521, 7675.15573286938, 6773.254941956381, 6780.660966951633, 6789.15135608049, 6793.59238445685, 6808.08090907731, 3733.8506459741307, 4052.8176232069627, 4056.127932494528, 4076.9184616307507, 4080.8775736727944, 7992.200779922077, 8139.186081391814, 8178.836423271501, 8188.017437907489, 8232.958835205785, 6948.33990770876, 8055.879161812461, 8111.351091912751, 8133.75598732039, 8134.55259960696, 8090.514569125989, 8116.553589552631, 8145.389095817837, 8150.7147249845975, 8157.265846073882, 7495.287947644965, 7817.0619525657285, 7820.413468989962, 7829.099653539915, 7842.411819113703, 7623.923760762544, 7646.579438130733, 7666.884996724942, 7679.963204967258, 7696.384289256958, 6534.869302614016, 8126.471779334324, 8137.593120344078, 8147.511149331059, 8193.385496087698, 4980.701157930535, 4981.227909674007, 4982.227754698028, 4991.101601711727, 4996.800127994985, 6142.262928448615, 6388.680565971776, 7274.345308922222, 7369.963150184215, 7788.805279868048, 6195.4424101831055, 7352.4485663576515, 7411.962940185264, 7421.628918554159, 7441.0, 7404.0, 7407.518511296748, 7419.962900185465, 7432.996545466292, 7437.070366204224, 5918.526517878646, 6211.782587609412, 6982.546134501241, 7009.474289428212, 7228.168760592599, 6198.442140207403, 7320.487565870338, 7373.18894921569, 7414.369778568882, 7429.368503677248, 7209.6395180241825, 7221.277872212737, 7221.855562888818, 7230.927690723236, 7248.383887369632], "unit": "score", "name": "prototype.html", "value": 5333.203020015319}, {"lowerIsBetter": false, "replicates": [681.843176069504, 685.8422562810551, 718.6514540447885, 750.3996802557953, 753.3483536740721, 15131.62170945727, 15364.923175384107, 15472.767908481368, 15475.767863482057, 15502.22488875556, 14204.28978551071, 14271.71456570868, 16053.277602507886, 16289.592760181002, 16353.591160221, 754.1440465072155, 930.9627614895396, 934.042606328512, 945.2013048973606, 947.3652652722658, 924.2929159193222, 935.4153653966271, 945.1304799584365, 947.0813311088233, 948.8529277961892, 992.3599278465385, 1002.7092143278477, 1004.6031817432109, 1006.6124542051326, 1009.0061289629746, 966.2559828931718, 988.1798107570735, 992.9702108936743, 997.3816233934934, 999.8050380175869, 701.3197198717236, 725.151572659989, 728.4281838756604, 738.9408847292203, 744.6239648977232, 15522.0, 15570.14364209968, 15717.449889253936, 15747.0, 15804.683906321809, 12394.62816115518, 12405.751884962341, 12421.31682757448, 12506.999440044865, 12557.811632825515, 9795.412275263507, 9979.30144889858, 10049.799004019878, 10167.644132455402, 10430.269881108325, 3090.057532452601, 3367.3770352484867, 3414.2830005698834, 3538.203904121552, 3539.1152211947015, 67517.0, 67988.0, 68117.0, 76550.0, 80769.59615201886, 9254.86117708235, 9294.721158365124, 9320.487373194539, 9434.198093162158, 9447.055294470498, 20778.584428311347, 20782.27262045821, 20788.27241046556, 20808.37574872726, 20878.582428351652, 7456.739014134588, 7549.169591344948, 7559.357454616309, 7564.205758395399, 7661.387089032975, 4100.835966561363, 4178.582141785858, 4181.351890456984, 4183.895402614898, 4184.707070505096, 3543.875964341236, 3572.392693242155, 3591.964080359163, 3598.2803439312243, 3603.0271826606668, 631.1983780598614, 631.8104568629485, 635.3995474276857, 650.6746626686656, 655.2006552006544, 535.7053620508705, 576.5589324167015, 595.964242145464, 596.7344531683359, 618.5021058048225, 6889.483288753364, 8005.439619226599, 8259.793505162299, 8270.297024752843, 8317.263853386536, 465.8346287068042, 516.6925679220858, 547.1437200780765, 568.7724910036019, 569.8746275819313, 3725.4784330193793, 3727.2731817295366, 3822.3502004659276, 3951.8616848410165, 4060.0864805419137, 73062.0, 77750.05624859424, 81541.59229203816, 83574.58212708897, 84459.0, 67478.98781518282, 67995.0, 70862.64568677227, 72542.63728681323, 73559.0, 50226.74886625617, 62290.75418491605, 63128.05307920385, 64009.679951599945, 64911.02633460502, 7815.648295826588, 7833.09919359281, 7881.369490440866, 7897.68409263623, 7913.86538986326, 34016.82991585026, 46903.0, 47340.7632961833, 47443.0, 47564.52435475739, 59555.0, 62290.377096228454, 62609.68695156677, 62793.68603156955, 62882.74234515193, 9676.612935482503, 9819.950900245452, 9939.701808945743, 10058.245631577514, 10521.105706015074, 9011.414258073204, 10985.560577576807, 11027.283226590245, 11066.502007409525, 11247.493862776031, 10296.794064118825, 10342.689719308433, 10430.113440357654, 10537.57849686004, 10663.733406664895, 10229.437380943822, 10282.280240383101, 10347.172226221734, 11103.333799971704, 11108.277961932448, 10004.049615286536, 10446.68659940203, 10526.842097368393, 10595.15238780911, 10655.360678359324, 8656.956715216384, 8747.475151490931, 8777.385583009129, 8837.558122093998, 8906.688265910661, 8814.0, 8891.866622000545, 8933.642654293755, 8963.282937364866, 9022.458652480873], "unit": "score", "name": "yui.html", "value": 6681.712877754116}], "name": "dromaeo_css", "value": 7369.38489762566}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 109.0, 115.0, 114.0, 115.0, 126.0, 111.0, 115.0, 116.0, 114.0], "unit": "score", "name": "ai-astar", "value": 114.7}, {"lowerIsBetter": true, "replicates": [147.0, 123.0, 139.0, 153.0, 127.0, 184.0, 170.0, 158.0, 162.0, 126.0], "unit": "score", "name": "audio-beat-detection", "value": 148.9}, {"lowerIsBetter": true, "replicates": [201.0, 201.0, 197.0, 203.0, 207.0, 214.0, 261.0, 240.0, 204.0, 197.0], "unit": "score", "name": "audio-dft", "value": 212.5}, {"lowerIsBetter": true, "replicates": [59.0, 61.0, 73.0, 83.0, 72.0, 133.0, 55.0, 59.0, 68.0, 84.0], "unit": "score", "name": "audio-fft", "value": 74.7}, {"lowerIsBetter": true, "replicates": [84.0, 82.0, 127.0, 79.0, 83.0, 80.0, 120.0, 80.0, 83.0, 119.0], "unit": "score", "name": "audio-oscillator", "value": 93.7}, {"lowerIsBetter": true, "replicates": [92.0, 89.0, 91.0, 88.0, 90.0, 87.0, 90.0, 88.0, 91.0, 86.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 89.2}, {"lowerIsBetter": true, "replicates": [104.0, 95.0, 96.0, 94.0, 96.0, 95.0, 95.0, 120.0, 95.0, 96.0], "unit": "score", "name": "imaging-darkroom", "value": 98.6}, {"lowerIsBetter": true, "replicates": [92.0, 90.0, 90.0, 91.0, 94.0, 76.0, 77.0, 138.0, 77.0, 107.0], "unit": "score", "name": "imaging-desaturate", "value": 93.2}, {"lowerIsBetter": true, "replicates": [56.0, 57.0, 55.0, 57.0, 55.0, 58.0, 56.0, 63.0, 56.0, 54.0], "unit": "score", "name": "json-parse-financial", "value": 56.7}, {"lowerIsBetter": true, "replicates": [70.0, 68.0, 73.0, 68.0, 75.0, 75.0, 69.0, 72.0, 71.0, 70.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 71.1}, {"lowerIsBetter": true, "replicates": [99.0, 108.0, 92.0, 88.0, 86.0, 83.0, 87.0, 86.0, 85.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 89.7}, {"lowerIsBetter": true, "replicates": [136.0, 124.0, 131.0, 128.0, 137.0, 129.0, 123.0, 131.0, 135.0, 121.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 129.5}, {"lowerIsBetter": true, "replicates": [149.0, 141.0, 128.0, 157.0, 181.0, 189.0, 140.0, 136.0, 140.0, 142.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 150.3}, {"lowerIsBetter": true, "replicates": [69.0, 67.0, 69.0, 69.0, 67.0, 96.0, 96.0, 97.0, 71.0, 69.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 77.0}], "name": "kraken", "value": 1499.8000000000002}]} 05:21:39 INFO - Return code: 0 05:21:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 05:21:39 ERROR - # TBPL SUCCESS # 05:21:39 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:21:39 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:21:39 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:21:40 INFO - 2016-03-07 05:21:40.004 screenresolution[1994:31880] starting screenresolution argv=screenresolution get 05:21:40 INFO - 2016-03-07 05:21:40.007 screenresolution[1994:31880] Display 0: 1600x1200x32@60 05:21:40 INFO - 2016-03-07 05:21:40.013 screenresolution[1995:31883] starting screenresolution argv=screenresolution list 05:21:40 INFO - Available Modes on Display 0 05:21:40 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:21:40 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:21:40 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:21:40 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:21:40 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:21:40 INFO - Intel Iris: 05:21:40 INFO - Chipset Model: Intel Iris 05:21:40 INFO - Type: GPU 05:21:40 INFO - Bus: Built-In 05:21:40 INFO - VRAM (Dynamic, Max): 1536 MB 05:21:40 INFO - Vendor: Intel (0x8086) 05:21:40 INFO - Device ID: 0x0a2e 05:21:40 INFO - Revision ID: 0x0009 05:21:40 INFO - Displays: 05:21:40 INFO - Display: 05:21:40 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:21:40 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:21:40 INFO - Display Serial Number: 1600x1200 60 05:21:40 INFO - Main Display: Yes 05:21:40 INFO - Mirror: Off 05:21:40 INFO - Online: Yes 05:21:40 INFO - Rotation: Supported 05:21:40 INFO - Return code: 0 05:21:40 INFO - Running post-action listener: _resource_record_post_action 05:21:40 INFO - Running post-run listener: _resource_record_post_run 05:21:41 INFO - Total resource usage - Wall time: 1205s; CPU: 54.0%; Read bytes: 2506752; Write bytes: 705396224; Read time: 45; Write time: 1904 05:21:41 INFO - install - Wall time: 34s; CPU: 55.0%; Read bytes: 401570304; Write bytes: 403687424; Read time: 30256; Write time: 756 05:21:41 INFO - run-tests - Wall time: 1171s; CPU: 54.0%; Read bytes: 2502656; Write bytes: 299996672; Read time: 44; Write time: 1141 05:21:41 INFO - Running post-run listener: _upload_blobber_files 05:21:41 INFO - Blob upload gear active. 05:21:41 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:21:41 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 05:21:41 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'] 05:21:41 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 05:21:41 INFO - (blobuploader) - INFO - Open directory for files ... 05:21:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:21:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:21:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:21:42 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:21:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:21:42 INFO - (blobuploader) - INFO - Done attempting. 05:21:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 05:21:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:21:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:21:43 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 05:21:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:21:43 INFO - (blobuploader) - INFO - Done attempting. 05:21:43 INFO - (blobuploader) - INFO - Iteration through files over. 05:21:43 INFO - Return code: 0 05:21:43 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:21:43 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:21:43 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9942b7793f07112478f5482dde7997d2d702539795c62d95d603ccdef6d093f6eee4428a34b9fbd0949a42a68ba98fbf91157015bd4e94a0f4bcfa28312b3601", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8aa411ec5781d240a5ebfc235653826a41218c3d18022995d58c33e182f8d88ab0b7a71b970ef27ac1399bfbf26702956489ef944bdd73c98c081e8819d0acbb"} 05:21:43 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:21:43 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:21:43 INFO - Contents: 05:21:43 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9942b7793f07112478f5482dde7997d2d702539795c62d95d603ccdef6d093f6eee4428a34b9fbd0949a42a68ba98fbf91157015bd4e94a0f4bcfa28312b3601", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8aa411ec5781d240a5ebfc235653826a41218c3d18022995d58c33e182f8d88ab0b7a71b970ef27ac1399bfbf26702956489ef944bdd73c98c081e8819d0acbb"} 05:21:43 INFO - Running post-run listener: copy_logs_to_upload_dir 05:21:43 INFO - Copying logs to upload dir... 05:21:43 INFO - mkdir: /builds/slave/test/build/upload/logs 05:21:43 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1269.829390 ========= master_lag: 1.65 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 11 secs) (at 2016-03-07 05:21:45.595593) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 3 secs) (at 2016-03-07 05:21:45.596718) ========= 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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9942b7793f07112478f5482dde7997d2d702539795c62d95d603ccdef6d093f6eee4428a34b9fbd0949a42a68ba98fbf91157015bd4e94a0f4bcfa28312b3601", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8aa411ec5781d240a5ebfc235653826a41218c3d18022995d58c33e182f8d88ab0b7a71b970ef27ac1399bfbf26702956489ef944bdd73c98c081e8819d0acbb"} build_url:https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011300 build_url: 'https://queue.taskcluster.net/v1/task/Z7chUqTGRK2Y1iP6u7R2TA/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9942b7793f07112478f5482dde7997d2d702539795c62d95d603ccdef6d093f6eee4428a34b9fbd0949a42a68ba98fbf91157015bd4e94a0f4bcfa28312b3601", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8aa411ec5781d240a5ebfc235653826a41218c3d18022995d58c33e182f8d88ab0b7a71b970ef27ac1399bfbf26702956489ef944bdd73c98c081e8819d0acbb"}' ========= master_lag: 3.08 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 3 secs) (at 2016-03-07 05:21:48.689242) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 3 secs) (at 2016-03-07 05:21:48.689636) ========= 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.qhayTlzNPQ/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.zvfaz7xLPM/Listeners TMPDIR=/var/folders/5h/cmwhq37s15q4p6v6d2gyhw5w00000w/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.005188 ========= master_lag: 3.74 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 3 secs) (at 2016-03-07 05:21:52.432086) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-07 05:21:52.432450) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-07 05:21:52.442239) ========= ========= Total master_lag: 8.93 =========