builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0160 starttime: 1457660769.31 results: success (0) buildid: 20160310154513 builduid: 64b5730105fc493d8bb0fb01b8546457 revision: b2e8a5b5b25639e71f879cfc80a8aa2876d7482a ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:09.310734) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:09.311104) ========= ========= Started set props: basedir (results: 0, elapsed: 1 secs) (at 2016-03-10 17:46:09.311383) ========= 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.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/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.005598 basedir: '/builds/slave/test' ========= master_lag: 1.29 ========= ========= Finished set props: basedir (results: 0, elapsed: 1 secs) (at 2016-03-10 17:46:10.605321) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 19 secs) (at 2016-03-10 17:46:10.605623) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 19 secs) (at 2016-03-10 17:46:30.052878) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:30.053203) ========= 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.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/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.006171 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:30.091558) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:30.094829) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:30.095140) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:30.095446) ========= 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.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/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-10 17:46:30-- 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% 19.4M=0.001s 2016-03-10 17:46:30 (19.4 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.597261 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:30.716182) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:30.716458) ========= 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.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/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.026208 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:30.770806) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-03-10 17:46:30.771108) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev b2e8a5b5b25639e71f879cfc80a8aa2876d7482a --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 b2e8a5b5b25639e71f879cfc80a8aa2876d7482a --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/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-10 17:46:30,851 truncating revision to first 12 chars 2016-03-10 17:46:30,851 Setting DEBUG logging. 2016-03-10 17:46:30,851 attempt 1/10 2016-03-10 17:46:30,851 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/b2e8a5b5b256?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-10 17:46:32,573 unpacking tar archive at: fx-team-b2e8a5b5b256/testing/mozharness/ program finished with exit code 0 elapsedTime=1.997030 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-03-10 17:46:32.788926) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:32.789223) ========= echo b2e8a5b5b25639e71f879cfc80a8aa2876d7482a in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'b2e8a5b5b25639e71f879cfc80a8aa2876d7482a'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/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 b2e8a5b5b25639e71f879cfc80a8aa2876d7482a program finished with exit code 0 elapsedTime=0.005288 script_repo_revision: 'b2e8a5b5b25639e71f879cfc80a8aa2876d7482a' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:32.841171) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:32.841450) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-10 17:46:32.861895) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 10 secs) (at 2016-03-10 17:46:32.862159) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 17:46:33 INFO - MultiFileLogger online at 20160310 17:46:33 in /builds/slave/test 17:46:33 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 17:46:33 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:46:33 INFO - {'append_to_log': False, 17:46:33 INFO - 'base_work_dir': '/builds/slave/test', 17:46:33 INFO - 'blob_upload_branch': 'Fx-Team', 17:46:33 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:46:33 INFO - 'branch': 'Fx-Team', 17:46:33 INFO - 'buildbot_json_path': 'buildprops.json', 17:46:33 INFO - 'config_files': ('talos/mac_config.py',), 17:46:33 INFO - 'default_actions': ('clobber', 17:46:33 INFO - 'read-buildbot-config', 17:46:33 INFO - 'download-and-extract', 17:46:33 INFO - 'populate-webroot', 17:46:33 INFO - 'create-virtualenv', 17:46:33 INFO - 'install', 17:46:33 INFO - 'run-tests'), 17:46:33 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:46:33 INFO - 'download_minidump_stackwalk': True, 17:46:33 INFO - 'download_symbols': 'ondemand', 17:46:33 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:46:33 INFO - 'tooltool.py': '/tools/tooltool.py', 17:46:33 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:46:33 INFO - '/tools/misc-python/virtualenv.py')}, 17:46:33 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:46:33 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:46:33 INFO - 'installer_path': 'installer.exe', 17:46:33 INFO - 'log_level': 'info', 17:46:33 INFO - 'log_name': 'talos', 17:46:33 INFO - 'log_to_console': True, 17:46:33 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 17:46:33 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 17:46:33 INFO - 'opt_config_files': (), 17:46:33 INFO - 'pip_index': False, 17:46:33 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:46:33 INFO - 'cmd': ('bash', 17:46:33 INFO - '-c', 17:46:33 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:46:33 INFO - 'enabled': True, 17:46:33 INFO - 'halt_on_failure': False, 17:46:33 INFO - 'name': 'check_screen_resolution'},), 17:46:33 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:46:33 INFO - 'cmd': ('bash', 17:46:33 INFO - '-c', 17:46:33 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:46:33 INFO - 'enabled': True, 17:46:33 INFO - 'halt_on_failure': False, 17:46:33 INFO - 'name': 'check_screen_resolution'},), 17:46:33 INFO - 'run_cmd_checks_enabled': True, 17:46:33 INFO - 'sps_profile': False, 17:46:33 INFO - 'sps_profile_interval': 0, 17:46:33 INFO - 'suite': 'dromaeojs', 17:46:33 INFO - 'system_bits': '32', 17:46:33 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:46:33 INFO - 'title': 't-yosemite-r7-0160', 17:46:33 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:46:33 INFO - 'use_talos_json': True, 17:46:33 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:46:33 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:46:33 INFO - 'work_dir': 'build'} 17:46:33 INFO - ##### 17:46:33 INFO - ##### Running clobber step. 17:46:33 INFO - ##### 17:46:33 INFO - Running pre-action listener: _resource_record_pre_action 17:46:33 INFO - Running main action method: clobber 17:46:33 INFO - rmtree: /builds/slave/test/build 17:46:33 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:46:34 INFO - Running post-action listener: _resource_record_post_action 17:46:34 INFO - ##### 17:46:34 INFO - ##### Running read-buildbot-config step. 17:46:34 INFO - ##### 17:46:34 INFO - Running pre-action listener: _resource_record_pre_action 17:46:34 INFO - Running main action method: read_buildbot_config 17:46:34 INFO - Using buildbot properties: 17:46:34 INFO - { 17:46:34 INFO - "project": "", 17:46:34 INFO - "product": "firefox", 17:46:34 INFO - "script_repo_revision": "production", 17:46:34 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 17:46:34 INFO - "repository": "", 17:46:34 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 17:46:34 INFO - "buildid": "20160310154513", 17:46:34 INFO - "pgo_build": "False", 17:46:34 INFO - "basedir": "/builds/slave/test", 17:46:34 INFO - "buildnumber": 569, 17:46:34 INFO - "slavename": "t-yosemite-r7-0160", 17:46:34 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 17:46:34 INFO - "platform": "yosemite_r7", 17:46:34 INFO - "scheduler": "tests-fx-team-macosx64-talos", 17:46:34 INFO - "branch": "fx-team", 17:46:34 INFO - "repo_path": "integration/fx-team", 17:46:34 INFO - "revision": "b2e8a5b5b25639e71f879cfc80a8aa2876d7482a", 17:46:34 INFO - "stage_platform": "macosx64", 17:46:34 INFO - "builduid": "64b5730105fc493d8bb0fb01b8546457", 17:46:34 INFO - "slavebuilddir": "test" 17:46:34 INFO - } 17:46:34 INFO - Found installer url https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg. 17:46:34 INFO - Running post-action listener: _resource_record_post_action 17:46:34 INFO - ##### 17:46:34 INFO - ##### Running download-and-extract step. 17:46:34 INFO - ##### 17:46:34 INFO - Running pre-action listener: _resource_record_pre_action 17:46:34 INFO - Running main action method: download_and_extract 17:46:34 INFO - mkdir: /builds/slave/test/build/tests 17:46:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:46:34 INFO - https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 17:46:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 17:46:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 17:46:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 17:46:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json'}, attempt #1 17:46:37 INFO - Downloaded 1199 bytes. 17:46:37 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 17:46:37 INFO - Using the following test package requirements: 17:46:37 INFO - {u'common': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 17:46:37 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:46:37 INFO - u'firefox-48.0a1.en-US.mac.cppunittest.tests.zip'], 17:46:37 INFO - u'gtest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:46:37 INFO - u'firefox-48.0a1.en-US.mac.gtest.tests.zip'], 17:46:37 INFO - u'jittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:46:37 INFO - u'jsshell-mac.zip'], 17:46:37 INFO - u'mochitest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:46:37 INFO - u'firefox-48.0a1.en-US.mac.mochitest.tests.zip'], 17:46:37 INFO - u'mozbase': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 17:46:37 INFO - u'reftest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:46:37 INFO - u'firefox-48.0a1.en-US.mac.reftest.tests.zip'], 17:46:37 INFO - u'talos': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:46:37 INFO - u'firefox-48.0a1.en-US.mac.talos.tests.zip'], 17:46:37 INFO - u'web-platform': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:46:37 INFO - u'firefox-48.0a1.en-US.mac.web-platform.tests.zip'], 17:46:37 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:46:37 INFO - u'firefox-48.0a1.en-US.mac.xpcshell.tests.zip']} 17:46:37 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip'] for test suite category: common 17:46: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')]} 17:46:37 INFO - https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 17:46:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:46:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:46:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:46:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 17:46:39 INFO - Downloaded 17867704 bytes. 17:46:39 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:46:39 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 17:46:42 INFO - Return code: 0 17:46:42 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip', u'firefox-48.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 17:46:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:46:42 INFO - https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 17:46:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:46:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:46:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:46:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 17:46:44 INFO - Downloaded 17867704 bytes. 17:46:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:46:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 17:46:47 INFO - Return code: 0 17:46:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:46:47 INFO - https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 17:46:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:46:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:46:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:46:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip'}, attempt #1 17:46:49 INFO - Downloaded 10845161 bytes. 17:46:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:46:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 17:46:49 INFO - Return code: 0 17:46:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:46:49 INFO - https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 17:46:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:46:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:46:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg 17:46:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg'}, attempt #1 17:46:52 INFO - Downloaded 110987005 bytes. 17:46:52 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:46:52 INFO - mkdir: /builds/slave/test/properties 17:46:52 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:46:52 INFO - Writing to file /builds/slave/test/properties/build_url 17:46:52 INFO - Contents: 17:46:52 INFO - build_url:https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:46:53 INFO - Running post-action listener: _resource_record_post_action 17:46:53 INFO - Running post-action listener: set_extra_try_arguments 17:46:53 INFO - ##### 17:46:53 INFO - ##### Running populate-webroot step. 17:46:53 INFO - ##### 17:46:53 INFO - Running pre-action listener: _resource_record_pre_action 17:46:53 INFO - Running main action method: populate_webroot 17:46:53 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:46:53 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:46:53 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:46:53 INFO - '--tppagecycles', 17:46:53 INFO - '7'], 17:46:53 INFO - 'tests': ['tsvgm']}}, 17:46:53 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 17:46:53 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:46:53 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 17:46:53 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:46:53 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:46:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:46:53 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:46:53 INFO - 'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:46:53 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:46:53 INFO - 'tests': ['damp', 'tps']}, 17:46:53 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:46:53 INFO - 'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['damp', 'tps']}, 17:46:53 INFO - 'g3': {'tests': ['dromaeo_dom']}, 17:46:53 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:46:53 INFO - 'other': {'tests': ['a11yr', 17:46:53 INFO - 'ts_paint', 17:46:53 INFO - 'tpaint', 17:46:53 INFO - 'sessionrestore', 17:46:53 INFO - 'sessionrestore_no_auto_restore', 17:46:53 INFO - 'tabpaint']}, 17:46:53 INFO - 'other-e10s': {'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['a11yr', 17:46:53 INFO - 'ts_paint', 17:46:53 INFO - 'tpaint', 17:46:53 INFO - 'sessionrestore', 17:46:53 INFO - 'sessionrestore_no_auto_restore', 17:46:53 INFO - 'tabpaint']}, 17:46:53 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['a11yr', 17:46:53 INFO - 'ts_paint', 17:46:53 INFO - 'tpaint', 17:46:53 INFO - 'sessionrestore', 17:46:53 INFO - 'sessionrestore_no_auto_restore', 17:46:53 INFO - 'tabpaint']}, 17:46:53 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['a11yr', 17:46:53 INFO - 'ts_paint', 17:46:53 INFO - 'tpaint', 17:46:53 INFO - 'sessionrestore', 17:46:53 INFO - 'sessionrestore_no_auto_restore', 17:46:53 INFO - 'tabpaint']}, 17:46:53 INFO - 'other_l64': {'tests': ['a11yr', 17:46:53 INFO - 'ts_paint', 17:46:53 INFO - 'tpaint', 17:46:53 INFO - 'sessionrestore', 17:46:53 INFO - 'sessionrestore_no_auto_restore', 17:46:53 INFO - 'tabpaint']}, 17:46:53 INFO - 'other_nol64': {'tests': ['a11yr', 17:46:53 INFO - 'ts_paint', 17:46:53 INFO - 'tpaint', 17:46:53 INFO - 'sessionrestore', 17:46:53 INFO - 'sessionrestore_no_auto_restore', 17:46:53 INFO - 'tabpaint']}, 17:46:53 INFO - 'svgr': {'tests': ['tsvgx', 17:46:53 INFO - 'tsvgr_opacity', 17:46:53 INFO - 'tart', 17:46:53 INFO - 'tscrollx', 17:46:53 INFO - 'cart']}, 17:46:53 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['tsvgx', 17:46:53 INFO - 'tsvgr_opacity', 17:46:53 INFO - 'tart', 17:46:53 INFO - 'tscrollx', 17:46:53 INFO - 'cart']}, 17:46:53 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:46:53 INFO - 'tests': ['tp5o']}, 17:46:53 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:46:53 INFO - 'talos_options': ['--e10s'], 17:46:53 INFO - 'tests': ['tp5o']}, 17:46:53 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:46:53 INFO - 'talos_options': ['--xperf_path', 17:46:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:46:53 INFO - 'tests': ['tp5n']}, 17:46:53 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:46:53 INFO - 'talos_options': ['--e10s', 17:46:53 INFO - '--xperf_path', 17:46:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:46:53 INFO - 'tests': ['tp5n']}}, 17:46:53 INFO - 'talos.zip': {'path': '', 17:46:53 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:46:53 INFO - Running post-action listener: _resource_record_post_action 17:46:53 INFO - ##### 17:46:53 INFO - ##### Running create-virtualenv step. 17:46:53 INFO - ##### 17:46:53 INFO - Running pre-action listener: _resource_record_pre_action 17:46:53 INFO - Running main action method: create_virtualenv 17:46:53 INFO - Creating virtualenv /builds/slave/test/build/venv 17:46:53 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 17:46:53 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:46:53 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:46:53 INFO - Using real prefix '/tools/python27' 17:46:53 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:46:54 INFO - Installing distribute.............................................................................................................................................................................................done. 17:46:57 INFO - Installing pip.................done. 17:46:57 INFO - Return code: 0 17:46:57 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:46: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')]} 17:46:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:46:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:46: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')]} 17:46:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:46:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:46:57 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 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:46:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 17:46:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 17:46:57 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:46:57 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:46:57 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:46:57 INFO - 'HOME': '/Users/cltbld', 17:46:57 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:46:57 INFO - 'LOGNAME': 'cltbld', 17:46:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:46:57 INFO - 'MOZ_NO_REMOTE': '1', 17:46:57 INFO - 'NO_EM_RESTART': '1', 17:46:57 INFO - 'PAGER': '/bin/cat', 17:46:57 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:46:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:46:57 INFO - 'PWD': '/builds/slave/test', 17:46:57 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:46:57 INFO - 'SHELL': '/bin/bash', 17:46:57 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:46:57 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:46:57 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:46:57 INFO - 'USER': 'cltbld', 17:46:57 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:46:57 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:46:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:46:57 INFO - 'XPC_FLAGS': '0x0', 17:46:57 INFO - 'XPC_SERVICE_NAME': '0', 17:46:57 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:46:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:46:57 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 17:46:57 INFO - Cleaning up... 17:46:57 INFO - Return code: 0 17:46:57 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 17:46: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')]} 17:46:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:46:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:46: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')]} 17:46:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:46:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:46:57 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 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:46:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 17:46:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 17:46:57 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:46:57 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:46:57 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:46:57 INFO - 'HOME': '/Users/cltbld', 17:46:57 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:46:57 INFO - 'LOGNAME': 'cltbld', 17:46:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:46:57 INFO - 'MOZ_NO_REMOTE': '1', 17:46:57 INFO - 'NO_EM_RESTART': '1', 17:46:57 INFO - 'PAGER': '/bin/cat', 17:46:57 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:46:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:46:57 INFO - 'PWD': '/builds/slave/test', 17:46:57 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:46:57 INFO - 'SHELL': '/bin/bash', 17:46:57 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:46:57 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:46:57 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:46:57 INFO - 'USER': 'cltbld', 17:46:57 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:46:57 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:46:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:46:57 INFO - 'XPC_FLAGS': '0x0', 17:46:57 INFO - 'XPC_SERVICE_NAME': '0', 17:46:57 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:46:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:46:57 INFO - Downloading/unpacking psutil>=0.7.1 17:46:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:46:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:46:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:46:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:46:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:46:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:47:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:47:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:47:00 INFO - Installing collected packages: psutil 17:47:00 INFO - Running setup.py install for psutil 17:47:00 INFO - building 'psutil._psutil_osx' extension 17:47:00 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 17:47:01 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 17:47:01 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 17:47:01 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 17:47:01 INFO - building 'psutil._psutil_posix' extension 17:47:01 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 17:47:01 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 17:47:01 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 17:47:01 INFO - ^ 17:47:01 INFO - 1 warning generated. 17:47:01 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 17:47:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:47:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:47:02 INFO - Successfully installed psutil 17:47:02 INFO - Cleaning up... 17:47:02 INFO - Return code: 0 17:47:02 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 17:47:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:47:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:47:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:02 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 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:47:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 17:47:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 17:47:02 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:47:02 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:47:02 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:47:02 INFO - 'HOME': '/Users/cltbld', 17:47:02 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:47:02 INFO - 'LOGNAME': 'cltbld', 17:47:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:47:02 INFO - 'MOZ_NO_REMOTE': '1', 17:47:02 INFO - 'NO_EM_RESTART': '1', 17:47:02 INFO - 'PAGER': '/bin/cat', 17:47:02 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:47:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:47:02 INFO - 'PWD': '/builds/slave/test', 17:47:02 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:47:02 INFO - 'SHELL': '/bin/bash', 17:47:02 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:47:02 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:47:02 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:47:02 INFO - 'USER': 'cltbld', 17:47:02 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:47:02 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:47:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:47:02 INFO - 'XPC_FLAGS': '0x0', 17:47:02 INFO - 'XPC_SERVICE_NAME': '0', 17:47:02 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:47:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:47:02 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 17:47:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:04 INFO - Downloading mozsystemmonitor-0.0.tar.gz 17:47:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:47:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 17:47:04 INFO - Installing collected packages: mozsystemmonitor 17:47:04 INFO - Running setup.py install for mozsystemmonitor 17:47:04 INFO - Successfully installed mozsystemmonitor 17:47:04 INFO - Cleaning up... 17:47:05 INFO - Return code: 0 17:47:05 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:47:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:47:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:47:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:05 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 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:47:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 17:47:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 17:47:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:47:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:47:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:47:05 INFO - 'HOME': '/Users/cltbld', 17:47:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:47:05 INFO - 'LOGNAME': 'cltbld', 17:47:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:47:05 INFO - 'MOZ_NO_REMOTE': '1', 17:47:05 INFO - 'NO_EM_RESTART': '1', 17:47:05 INFO - 'PAGER': '/bin/cat', 17:47:05 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:47:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:47:05 INFO - 'PWD': '/builds/slave/test', 17:47:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:47:05 INFO - 'SHELL': '/bin/bash', 17:47:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:47:05 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:47:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:47:05 INFO - 'USER': 'cltbld', 17:47:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:47:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:47:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:47:05 INFO - 'XPC_FLAGS': '0x0', 17:47:05 INFO - 'XPC_SERVICE_NAME': '0', 17:47:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:47:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:47:05 INFO - Downloading/unpacking blobuploader==1.2.4 17:47: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 17:47: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 17:47: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 17:47: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 17:47: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 17:47: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 17:47:07 INFO - Downloading blobuploader-1.2.4.tar.gz 17:47:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:47:07 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:47:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:47:08 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:47:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:08 INFO - Downloading docopt-0.6.1.tar.gz 17:47:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:47:08 INFO - Installing collected packages: blobuploader, requests, docopt 17:47:08 INFO - Running setup.py install for blobuploader 17:47:08 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:47:09 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:47:09 INFO - Running setup.py install for requests 17:47:09 INFO - Running setup.py install for docopt 17:47:09 INFO - Successfully installed blobuploader requests docopt 17:47:09 INFO - Cleaning up... 17:47:09 INFO - Return code: 0 17:47:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:47:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:47:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:47:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:09 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 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:47:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:47:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:47:09 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:47:09 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:47:09 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:47:09 INFO - 'HOME': '/Users/cltbld', 17:47:09 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:47:09 INFO - 'LOGNAME': 'cltbld', 17:47:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:47:09 INFO - 'MOZ_NO_REMOTE': '1', 17:47:09 INFO - 'NO_EM_RESTART': '1', 17:47:09 INFO - 'PAGER': '/bin/cat', 17:47:09 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:47:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:47:09 INFO - 'PWD': '/builds/slave/test', 17:47:09 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:47:09 INFO - 'SHELL': '/bin/bash', 17:47:09 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:47:09 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:47:09 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:47:09 INFO - 'USER': 'cltbld', 17:47:09 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:47:09 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:47:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:47:09 INFO - 'XPC_FLAGS': '0x0', 17:47:09 INFO - 'XPC_SERVICE_NAME': '0', 17:47:09 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:47:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:47:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-Y0AYCv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-e1iWOG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-bX7pN7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-cIf7xI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-SnmnZc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-noEf6j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-_SgWCb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-t0SluG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-W7MhXO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:47:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:47:10 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-VwLuJa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:47:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:47:11 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-TZt_AC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:47:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:47:11 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-3Xp8z6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:47:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:47:11 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-Tpu1Pk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:47:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:47:11 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-_mMwMj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:47:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:47:11 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-s47P1R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:47:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:47:11 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-yo5Lnd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:47:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:47:11 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-lInKz_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:47:11 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:47:11 INFO - Running setup.py install for manifestparser 17:47:11 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:47:11 INFO - Running setup.py install for mozcrash 17:47:12 INFO - Running setup.py install for mozdebug 17:47:12 INFO - Running setup.py install for mozdevice 17:47:12 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 17:47:12 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:47:12 INFO - Running setup.py install for mozfile 17:47:12 INFO - Running setup.py install for mozhttpd 17:47:12 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:47:12 INFO - Running setup.py install for mozinfo 17:47:12 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:47:12 INFO - Running setup.py install for mozInstall 17:47:12 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:47:12 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:47:12 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:47:12 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:47:12 INFO - Running setup.py install for mozleak 17:47:13 INFO - Running setup.py install for mozlog 17:47:13 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:47:13 INFO - Running setup.py install for moznetwork 17:47:13 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:47:13 INFO - Running setup.py install for mozprocess 17:47:13 INFO - Running setup.py install for mozprofile 17:47:13 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:47:13 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:47:13 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:47:13 INFO - Running setup.py install for mozrunner 17:47:13 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:47:13 INFO - Running setup.py install for mozscreenshot 17:47:14 INFO - Running setup.py install for moztest 17:47:14 INFO - Running setup.py install for mozversion 17:47:14 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:47:14 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:47:14 INFO - Cleaning up... 17:47:14 INFO - Return code: 0 17:47:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:47:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:47:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:47:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:14 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 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:47:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:47:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:47:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:47:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:47:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:47:14 INFO - 'HOME': '/Users/cltbld', 17:47:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:47:14 INFO - 'LOGNAME': 'cltbld', 17:47:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:47:14 INFO - 'MOZ_NO_REMOTE': '1', 17:47:14 INFO - 'NO_EM_RESTART': '1', 17:47:14 INFO - 'PAGER': '/bin/cat', 17:47:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:47:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:47:14 INFO - 'PWD': '/builds/slave/test', 17:47:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:47:14 INFO - 'SHELL': '/bin/bash', 17:47:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:47:14 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:47:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:47:14 INFO - 'USER': 'cltbld', 17:47:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:47:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:47:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:47:14 INFO - 'XPC_FLAGS': '0x0', 17:47:14 INFO - 'XPC_SERVICE_NAME': '0', 17:47:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:47:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:47:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:47:14 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-Hq79M9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:47:14 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 17:47:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:47:14 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-WAE3CE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:47:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:47:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:47:14 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-LMT8ys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:47:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:47:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:47:14 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-GuuZ7A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-0gjt41-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-uuVJIO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-qwsjZI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-ONvki1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-nO3_45-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-8awABi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-8rw5_I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-7EEyhX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-sE_elM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:47:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 17:47:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:47:15 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-LI_dlV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 17:47:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:47:16 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-uZGp4j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 17:47:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:47:16 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-hll_Wm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 17:47:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:47:16 INFO - Running setup.py (path:/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/pip-cL03fG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:47:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:47:16 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:47:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:18 INFO - Downloading blessings-1.6.tar.gz 17:47:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:47:18 INFO - Installing collected packages: blessings 17:47:18 INFO - Running setup.py install for blessings 17:47:18 INFO - Successfully installed blessings 17:47:18 INFO - Cleaning up... 17:47:19 INFO - Return code: 0 17:47:19 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:47:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:47:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:47:19 INFO - Reading from file tmpfile_stdout 17:47:19 INFO - Current package versions: 17:47:19 INFO - blessings == 1.6 17:47:19 INFO - blobuploader == 1.2.4 17:47:19 INFO - docopt == 0.6.1 17:47:19 INFO - manifestparser == 1.1 17:47:19 INFO - mozInstall == 1.12 17:47:19 INFO - mozcrash == 0.17 17:47:19 INFO - mozdebug == 0.1 17:47:19 INFO - mozdevice == 0.48 17:47:19 INFO - mozfile == 1.2 17:47:19 INFO - mozhttpd == 0.7 17:47:19 INFO - mozinfo == 0.9 17:47:19 INFO - mozleak == 0.1 17:47:19 INFO - mozlog == 3.1 17:47:19 INFO - moznetwork == 0.27 17:47:19 INFO - mozprocess == 0.22 17:47:19 INFO - mozprofile == 0.28 17:47:19 INFO - mozrunner == 6.11 17:47:19 INFO - mozscreenshot == 0.1 17:47:19 INFO - mozsystemmonitor == 0.0 17:47:19 INFO - moztest == 0.7 17:47:19 INFO - mozversion == 1.4 17:47:19 INFO - psutil == 3.1.1 17:47:19 INFO - requests == 1.2.3 17:47:19 INFO - wsgiref == 0.1.2 17:47:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:47:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:47:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:47:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:19 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 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:47:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 17:47:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:47:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:47:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:47:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:47:19 INFO - 'HOME': '/Users/cltbld', 17:47:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:47:19 INFO - 'LOGNAME': 'cltbld', 17:47:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:47:19 INFO - 'MOZ_NO_REMOTE': '1', 17:47:19 INFO - 'NO_EM_RESTART': '1', 17:47:19 INFO - 'PAGER': '/bin/cat', 17:47:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:47:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:47:19 INFO - 'PWD': '/builds/slave/test', 17:47:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:47:19 INFO - 'SHELL': '/bin/bash', 17:47:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:47:19 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:47:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:47:19 INFO - 'USER': 'cltbld', 17:47:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:47:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:47:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:47:19 INFO - 'XPC_FLAGS': '0x0', 17:47:19 INFO - 'XPC_SERVICE_NAME': '0', 17:47:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:47:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:47:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:47:19 INFO - Cleaning up... 17:47:19 INFO - Return code: 0 17:47:19 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:47:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:47:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:47:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:47:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 17:47:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 17:47:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:47:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:47:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:47:19 INFO - 'HOME': '/Users/cltbld', 17:47:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:47:19 INFO - 'LOGNAME': 'cltbld', 17:47:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:47:19 INFO - 'MOZ_NO_REMOTE': '1', 17:47:19 INFO - 'NO_EM_RESTART': '1', 17:47:19 INFO - 'PAGER': '/bin/cat', 17:47:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:47:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:47:19 INFO - 'PWD': '/builds/slave/test', 17:47:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:47:19 INFO - 'SHELL': '/bin/bash', 17:47:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:47:19 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:47:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:47:19 INFO - 'USER': 'cltbld', 17:47:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:47:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:47:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:47:19 INFO - 'XPC_FLAGS': '0x0', 17:47:19 INFO - 'XPC_SERVICE_NAME': '0', 17:47:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:47:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:47:19 INFO - Downloading/unpacking jsonschema 17:47:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:22 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:47:22 INFO - Downloading/unpacking functools32 (from jsonschema) 17:47:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:22 INFO - Downloading functools32-3.2.3-2.tar.gz 17:47:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:47:22 INFO - warning: no files found matching '*.txt' 17:47:22 INFO - no previously-included directories found matching 'build' 17:47:22 INFO - no previously-included directories found matching 'dist' 17:47:22 INFO - no previously-included directories found matching '.git*' 17:47:22 INFO - Installing collected packages: jsonschema, functools32 17:47:22 INFO - Running setup.py install for functools32 17:47:22 INFO - warning: no files found matching '*.txt' 17:47:22 INFO - no previously-included directories found matching 'build' 17:47:22 INFO - no previously-included directories found matching 'dist' 17:47:22 INFO - no previously-included directories found matching '.git*' 17:47:22 INFO - Successfully installed jsonschema functools32 17:47:22 INFO - Cleaning up... 17:47:22 INFO - Return code: 0 17:47:22 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 17:47:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:47:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:47:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:47:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:47:22 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 0x10ba06a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ba0e4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6fbcd9c40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, '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.vZrn1llHMx/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.PRw7UMgwS0/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:47:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 17:47:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 17:47:22 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:47:22 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:47:22 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:47:22 INFO - 'HOME': '/Users/cltbld', 17:47:22 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:47:22 INFO - 'LOGNAME': 'cltbld', 17:47:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:47:22 INFO - 'MOZ_NO_REMOTE': '1', 17:47:22 INFO - 'NO_EM_RESTART': '1', 17:47:22 INFO - 'PAGER': '/bin/cat', 17:47:22 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:47:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:47:22 INFO - 'PWD': '/builds/slave/test', 17:47:22 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:47:22 INFO - 'SHELL': '/bin/bash', 17:47:22 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:47:22 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:47:22 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:47:22 INFO - 'USER': 'cltbld', 17:47:22 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:47:22 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:47:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:47:22 INFO - 'XPC_FLAGS': '0x0', 17:47:22 INFO - 'XPC_SERVICE_NAME': '0', 17:47:22 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:47:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:47:23 INFO - Downloading/unpacking flake8 17:47: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 17:47: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 17:47: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 17:47: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 17:47: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 17:47: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 17:47:25 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 17:47:25 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 17:47:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:25 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 17:47:25 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 17:47:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:26 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 17:47:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:47:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:47:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:47:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 17:47:26 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:47:26 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:47:26 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:47:26 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:47:26 INFO - no previously-included directories found matching 'docs/_build' 17:47:26 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 17:47:26 INFO - Running setup.py install for pep8 17:47:26 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:47:26 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:47:26 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:47:26 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:47:26 INFO - no previously-included directories found matching 'docs/_build' 17:47:27 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 17:47:27 INFO - Successfully installed flake8 mccabe pyflakes pep8 17:47:27 INFO - Cleaning up... 17:47:27 INFO - Return code: 0 17:47:27 INFO - Running post-action listener: _resource_record_post_action 17:47:27 INFO - Running post-action listener: _start_resource_monitoring 17:47:27 INFO - Starting resource monitoring. 17:47:27 INFO - ##### 17:47:27 INFO - ##### Running install step. 17:47:27 INFO - ##### 17:47:27 INFO - Running pre-action listener: _resource_record_pre_action 17:47:27 INFO - Running main action method: install 17:47:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:47:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:47:27 INFO - Reading from file tmpfile_stdout 17:47:27 INFO - Detecting whether we're running mozinstall >=1.0... 17:47:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:47:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:47:27 INFO - Reading from file tmpfile_stdout 17:47:27 INFO - Output received: 17:47:27 INFO - Usage: mozinstall [options] installer 17:47:27 INFO - Options: 17:47:27 INFO - -h, --help show this help message and exit 17:47:27 INFO - -d DEST, --destination=DEST 17:47:27 INFO - Directory to install application into. [default: 17:47:27 INFO - "/builds/slave/test"] 17:47:27 INFO - --app=APP Application being installed. [default: firefox] 17:47:27 INFO - mkdir: /builds/slave/test/build/application 17:47:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 17:47:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 17:48:01 INFO - Reading from file tmpfile_stdout 17:48:01 INFO - Output received: 17:48:01 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 17:48:01 INFO - Running post-action listener: _resource_record_post_action 17:48:01 INFO - ##### 17:48:01 INFO - ##### Running run-tests step. 17:48:01 INFO - ##### 17:48:01 INFO - Running pre-action listener: _resource_record_pre_action 17:48:01 INFO - Running main action method: run_tests 17:48:01 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:48:01 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:48:01 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:48:01 INFO - 2016-03-10 17:48:01.723 screenresolution[1652:7803] starting screenresolution argv=screenresolution get 17:48:01 INFO - 2016-03-10 17:48:01.726 screenresolution[1652:7803] Display 0: 1600x1200x32@60 17:48:01 INFO - 2016-03-10 17:48:01.731 screenresolution[1653:7805] starting screenresolution argv=screenresolution list 17:48:01 INFO - Available Modes on Display 0 17:48:01 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:48:01 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:48:01 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:48:01 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:48:01 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:48:01 INFO - Intel Iris: 17:48:01 INFO - Chipset Model: Intel Iris 17:48:01 INFO - Type: GPU 17:48:01 INFO - Bus: Built-In 17:48:01 INFO - VRAM (Dynamic, Max): 1536 MB 17:48:01 INFO - Vendor: Intel (0x8086) 17:48:01 INFO - Device ID: 0x0a2e 17:48:01 INFO - Revision ID: 0x0009 17:48:01 INFO - Displays: 17:48:01 INFO - Display: 17:48:01 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:48:01 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:48:01 INFO - Display Serial Number: 1600x1200 60 17:48:01 INFO - Main Display: Yes 17:48:01 INFO - Mirror: Off 17:48:01 INFO - Online: Yes 17:48:01 INFO - Rotation: Supported 17:48:01 INFO - Return code: 0 17:48:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:48:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:48:01 INFO - Python 2.7.3 17:48:01 INFO - Return code: 0 17:48:01 INFO - grabbing minidump binary from tooltool 17:48:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:48:01 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 0x10b8aad30>, '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 0x10b6cedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b8a1b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:48:01 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 17:48:01 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 17:48:02 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:48:02 INFO - Return code: 0 17:48:02 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 17:48:02 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:48:02 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:48:02 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 17:48:02 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:48:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 17:48:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 17:48:03 INFO - Return code: 0 17:48:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0160', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 17:48:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0160 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 17:48:03 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vZrn1llHMx/Render', 17:48:03 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:48:03 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:48:03 INFO - 'HOME': '/Users/cltbld', 17:48:03 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:48:03 INFO - 'LOGNAME': 'cltbld', 17:48:03 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:48:03 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 17:48:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:48:03 INFO - 'MOZ_NO_REMOTE': '1', 17:48:03 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:48:03 INFO - 'NO_EM_RESTART': '1', 17:48:03 INFO - 'PAGER': '/bin/cat', 17:48:03 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:48:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:48:03 INFO - 'PWD': '/builds/slave/test', 17:48:03 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:48:03 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:48:03 INFO - 'SHELL': '/bin/bash', 17:48:03 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.PRw7UMgwS0/Listeners', 17:48:03 INFO - 'TMPDIR': '/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/', 17:48:03 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:48:03 INFO - 'USER': 'cltbld', 17:48:03 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:48:03 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:48:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:48:03 INFO - 'XPC_FLAGS': '0x0', 17:48:03 INFO - 'XPC_SERVICE_NAME': '0', 17:48:03 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:48:03 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0160', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 17:48:03 INFO - mozversion application_buildid: 20160310154513 17:48:03 INFO - mozversion application_changeset: b2e8a5b5b25639e71f879cfc80a8aa2876d7482a 17:48:03 INFO - mozversion application_display_name: Nightly 17:48:03 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:48:03 INFO - mozversion application_name: Firefox 17:48:03 INFO - mozversion application_remotingname: firefox 17:48:03 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 17:48:03 INFO - mozversion application_vendor: Mozilla 17:48:03 INFO - mozversion application_version: 48.0a1 17:48:03 INFO - mozversion platform_buildid: 20160310154513 17:48:03 INFO - mozversion platform_changeset: b2e8a5b5b25639e71f879cfc80a8aa2876d7482a 17:48:03 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 17:48:03 INFO - mozversion platform_version: 48.0a1 17:48:03 INFO - using testdate: 1457660883 17:48:03 INFO - actual date: 1457660883 17:48:03 INFO - starting webserver on 'localhost:49271' 17:48:03 INFO - SUITE-START | Running 2 tests 17:48:03 INFO - TEST-START | dromaeo_css 17:48:03 INFO - operating with platform_type : mac_ 17:48:03 INFO - Initialising browser for dromaeo_css test... 17:48:03 INFO - TEST-INFO | started process 1671 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/tmpW5WSC1/profile http://localhost:49271/getInfo.html) 17:48:05 INFO - PROCESS | 1671 | __metrics Screen width/height:1600/1200 17:48:05 INFO - PROCESS | 1671 | colorDepth:24 17:48:05 INFO - PROCESS | 1671 | Browser inner width/height: 1024/689 17:48:05 INFO - PROCESS | 1671 | __metrics 17:48:06 INFO - PROCESS | 1671 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 17:48:06 ERROR - PROCESS | 1671 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 17:48:06 INFO - TEST-INFO | 1671: exit 0 17:48:06 INFO - Browser initialized. 17:48:06 INFO - Running cycle 1/1 for dromaeo_css test... 17:48:06 INFO - TEST-INFO | started process 1674 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/tmpW5WSC1/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:48:18 INFO - PROCESS | 1674 | RSS: Main: 243376128 17:48:18 INFO - PROCESS | 1674 | 17:49:09 INFO - PROCESS | 1674 | 1457660949304 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 17:51:19 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49271/tests/dromaeo/cssquery-ext.html) 17:51:21 INFO - PROCESS | 1674 | RSS: Main: 333291520 17:51:21 INFO - PROCESS | 1674 | 17:54:23 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-ext.html (next: http://localhost:49271/tests/dromaeo/cssquery-jquery.html) 17:54:23 INFO - PROCESS | 1674 | RSS: Main: 378540032 17:54:23 INFO - PROCESS | 1674 | 17:57:26 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49271/tests/dromaeo/cssquery-mootools.html) 17:57:26 INFO - PROCESS | 1674 | RSS: Main: 371879936 17:57:26 INFO - PROCESS | 1674 | 18:00:28 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49271/tests/dromaeo/cssquery-prototype.html) 18:00:29 INFO - PROCESS | 1674 | RSS: Main: 330022912 18:00:29 INFO - PROCESS | 1674 | 18:03:32 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49271/tests/dromaeo/cssquery-yui.html) 18:03:33 INFO - PROCESS | 1674 | RSS: Main: 331743232 18:03:33 INFO - PROCESS | 1674 | 18:06:35 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-yui.html (next: http://localhost:49271/tests/dromaeo/cssquery-dojo.html) 18:06:36 INFO - PROCESS | 1674 | RSS: Main: 428167168 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - PROCESS | 1674 | __start_tp_report 18:06:36 INFO - PROCESS | 1674 | _x_x_mozilla_page_load 18:06:36 INFO - PROCESS | 1674 | _x_x_mozilla_page_load_details 18:06:36 INFO - PROCESS | 1674 | |i|pagename|runs| 18:06:36 INFO - PROCESS | 1674 | |0;dojo.html;2917.372764855556;2949.675535691075;3507.3160733656932;3533.4523148911926;3595.9460608090867;5489.533389661883;5613.550915926727;5675.574331925107;5678.176664383662;5693.800716974902;4332.458442694663;5629.887402251952;5670.659760414378;5694.943050569493;5723.713814309289;5105.4128775190775;5106.514881086291;5129.948700512984;5146.356705411824;5317.415084340739;5206.245094461301;5238.3975842778;5268.631195816294;5276.419593844674;5281.815136470224;5045.4197767256865;5073.239014147871;5153.768080436389;5190.88395994861;5235.502627250406;5164.561012313958;5178.093833579109;5195.532402083831;5198.16829307309;5210.921836172461;5107.208382700687;5141.922871156936;5152.92270615941;5158.2520534522655;5175.974120129413;4485.372047913294;5528.419515950807;5607.934492446422;5636.859078523029;5640.661560306395;6210.689465526705;6246.187995560594;6267.9686601567155;6276.435120839146;6279.37206279373;6246.843828904268;6298.149749783766;6303.149074874879;6306.873862522724;6326.778562750328;4590.472095708969;5737.254156959611;5760.971195143998;5800.7099645018425;5833;6261.9373806262265;6289.937100628935;6290.433860952537;6305.8108256752375;6313.116163737081;6109.694515274218;6116.26604807426;6169.413905679043;6169.475594574512;6188.44304012641;6077.301110372276;6143.204841796972;6159.538034647419;6255.78104766331;6279.183706118175;6225.750969961151;6226.128342032119;6228.439440450381;6235.750569977241;6241.21984751906;6215.9378406216265;6236.314005459396;6250.593711408744;6250.968745156245;6259.6870156492;4799.160146974265;4815.614750819926;4888.120138375056;4890.755462226945;4915.975420122876;4312.892177695583;4404.53752355998;4432.889177770581;4434.246178149722;4452.287633978548;5671.234383358194;5673.971630141823;5677;5677.943220567824;5688.402717714663;6108.584917381041;6203.131561581382;6239.0953311770445;6255.6872156392;6275.027370757449;5718.485336319668;5724.77100915967;5740.827775166752;5743.339515955635;5748.338941021752;5218.6868787872845;5340.49265319794;5361.061814182581;5362.570994320445;5371.865703357447;6257.186565746424;6299.307076221612;6334.9683251584365;6338.492920566436;6343.8898192817;6278.8430289241305;6279.30927597973;6282.340354262919;6286.308506064238;6298.622082675054;6222.782202622887;6257.2491301044165;6316.368363163647;6318.747250109944;6332.493400528039;6122.123717501779;6229.283632382334;6244.969580019246;6247.937520624736;6252.937470625236;6244.906326405198;6275.654838983717;6279.497640188865;6283.497320214463;6302.180716506825;5951.1073338999495;5952.226210592596;6070.878582428415;6146.385361463997;6163.7842675506145;6120.386183820725;6126.914660831567;6137.065116418418;6141.723622436912;6151.661658608819;5930.555208359477;5954.880902381841;5955.255593050869;5955.40445955401;5962;5925.466707996301;5936.22829032223;6058.969705151446;6091.086337049478;6118.969405153124;5967.940320596738;5968.6717230551;5982.162497250475;5987.5808693391045;5988.28140623128 18:06:36 INFO - PROCESS | 1674 | |1;ext.html;508.9921954530028;530.9752178295887;583.0292562882801;630.1209812311826;639.4820195641529;39041;39502;39506.407403888894;39545.60454395455;39663;42438.57561424385;42915.78542107285;42923.78538107305;42951.570484295145;43087.56912430875;9476.905230947688;9699.660511882086;9710.223182145412;9723.173530249902;9724.124828765409;9550.092741189575;9689.176420004309;9690.12788849007;9691.854622180674;9704.466254356008;9791.069848364394;9860.654877079303;9885.75285617858;9887.159591434736;9897.406155630686;9772.218222542215;9853.014698530089;9856.802863942718;9882.901170988305;9883.456409897453;9555.569999350046;9704.126628603459;9704.563294651758;9720.951395242979;9725.6596019139;40701;41073.178536429405;41087.7945610273;41089.1782164355;41203.793981030205;3413.112590726404;3510.473428985647;3769.491118698968;3783.5270591176104;3913.8630147944687;26801.92792288306;26992.325191870164;27607.585886211724;29729.25676858074;29964.101076967727;2705.2830999785074;2755.8032682088683;2802.649668791401;2826.1662809471254;2931.106012666136;347709;349722;350008.24995875114;350293;350316;59154.70422647859;59577.40422595805;59840;59910;60018.69990650019;62437.68781156065;62509.749805003645;65892.67053664701;66386;66575;17243;17474.86413383126;17491.950482971064;17497.650046998988;17524.123793810515;13220.206787592775;13288.202707837561;13301.002424818178;13317.134386265056;13324.200547967153;19300.8069919299;20195.192192312144;20222.09000594977;20260.18959241614;20272.594548108955;7925.207479252029;8083.636236369378;8730.38887277897;8768.868466973001;8792.736217913473;950.9952450237843;979.3046936674898;997.9201663866874;999.7850462150527;1071.7588542578014;28460;28744.13767586976;28970.8406504548;29006.564901526493;29299.267518312212;905.2712566384124;1057.2335057083553;1133.6485689436302;1134.6652737442473;1190.2858285029085;14599.92700036493;14609.78085328721;14691.191984440959;14945.551633451014;14969.176695281647;481401;484937;487648;489606;489837;57740;58824.41175588275;58907;58910.70544647249;58919.70540147272;1334.1128149780482;1365.5698454986648;1366.3851266929723;1422.2391020804027;1439.4026479011302;29346.413071738018;29509.852450738468;29592.265237562748;30371.69628303777;30456.543151853184;39558.604413955494;48991;49583.50416495933;49590.51228463152;49639.75180124076;428740;435509;435860;436053;436111;31338.05985820429;31989.520157197196;32499.18752031218;32532.02403927886;32567.67432325741;43519.78240108779;43635.34546981861;43730.78134609306;44216.7789161065;45084.77457612691;36039.81980090083;36216.456753148195;36317.63682363142;37217.06957326089;37287.627123728416;34978;35259.294814103065;35854;35910.92267231987;35979.82010089933;34237;34864.65135348614;35032.47451288182;35113.824430877685;35780.46329305114;30630.846845765627;31764.364712705155;31811.840940795148;31827.6817231834;31954.20114497156;22707.397454242655;23292.76707232906;23615.93728282266;23840.523189535765;24046 18:06:36 INFO - PROCESS | 1674 | |2;jquery.html;357.4031367616081;360.77271319068984;362.3803296363218;367.78117020372866;374.03685509812243;20080.4979875503;20511;21755;22061.669074963887;22126.557468850613;20209.595808083828;20211;20860.956952152406;20921.058552365143;21305.57388852222;5880.882382352351;6041.607295525799;6050.757969681207;6099.48154406876;6104.053871649901;5663.915041274384;5992.400759924017;5996.670183139926;6014.428629280212;6014.789482368118;5921.88156236875;5933.317668468138;5934.050551911695;5938.732757025944;5941.257342832146;5203.531682148625;5614.719264036782;5906.084556893646;5983.252093488336;5987.9101813472835;5135.512126347991;5168.3539557555305;5172.6379153459275;5173.094708426011;5174.974125129388;25708.871455642788;26108.477830443473;26583.867080664473;26648;26676.066337678087;1878.1360574135776;2039.3677959832498;2118.947026324339;2232.9888350558304;2301.3211102724736;10088.646897358558;10232.02795734404;12450.3152326622;12915.87084129156;14923.253837308199;1747.1264367816093;1808.8552915766707;1843.6312737452563;1860.897650629215;1891.1678861300984;66349;93936;97899;100532;105838;11213.327200368005;11303.660890173307;11411.657650270505;11415.372154531415;11559.36423496699;12221.266723996589;12602.810957835456;12918.41867115982;13400.597982060553;13424.328783560979;6538.8365290868105;6637.834054148589;8115.594220288962;8630.439021463584;8743.169398907221;8811.603477843513;8839.823203535892;8852.247558957431;8966.462012279284;8981.955090224506;4435.711678740871;4537.8411755588395;4549.408576884984;4558.908821823545;4597.310403439444;1850.7408962745226;1888.2447021191633;1890.0833095948453;1891.848652107828;1894;905.4612505559181;978.0708327089294;983.7983213441228;998.8951160128228;1041.8749750030045;17688.469345919642;19407;19726;19961.20155193805;20028;840.369722707969;944.367273926471;969.5636963366513;978.1490103609905;984.8178087053918;10353.256387057436;10777.461126943621;10781.784364312669;10867.967543083394;10887.18346124028;602043;620023;626998;651156;651370;112335;112423;113128;115283.42358288154;117642;1008.6721815410021;1022.3712416863575;1031.9638812641522;1036.740814796301;1039.1063685230695;13071.673208169872;17329.913350433166;17473.38843140484;18005.729914051037;18010.90994545019;45435.40976065822;47109.76445117752;47280.34518791964;48174.759126204146;49158.007882480364;69099;69635.65182174057;69729.65135174291;69916.95124573237;70350;7018.684159212746;7680.116786569616;8018.83962320762;8064.112947575879;8148.429609927248;9511.286653501153;10252.615896854128;12625.305608191638;13397.66505837362;13786.655333616338;11483.94258028738;11736.823947640622;11851.940740296242;11946.34295113777;12038.277703337828;10266.58933642646;11382.260153090023;11508.194426390408;11687.123465740273;11924;11720.003799677123;11825.763484730085;11906.40467976615;12045.63863084109;12196.451159698012;8162.469439486415;8201.13888041771;8223.342132629256;8334.6666133354;8544.017437994462;9828.754281143028;10452.738681533023;11858.347790871585;11963.923246907472;12052.09609279325 18:06:36 INFO - PROCESS | 1674 | |3;mootools.html;1440.5678296511044;1568.1061794776974;1593.7450007998718;1890.7636545431822;2029.5129168999445;7936.52380857149;8572.785680357987;8742.694005709802;8746.956265218681;8749.475031498114;8407.24334809867;8674.306055515559;8679.783005424868;8688.43525170865;8697.391182617204;2169.783021697833;2395.6047252203452;2447.926562203132;2468.259522143359;2479.665245191903;2485.378655336166;2495.7878580320694;2496.662950501677;2497.113524698724;2501.1496091328945;2397.7242617098996;2463.2610216934936;2486.5080951429177;2488.4276616378243;2488.726240113586;2441.475082857194;2468.0868078810777;2481.367251350903;2487.8756062196817;2492.7881130103965;2041.9489512762152;2434.0263894442187;2476.628505724138;2478.256523043098;2484.5527804995095;8711.912880871174;8798.340124490625;8798.736037918872;8801.867971980426;8812.911870881273;5349.946500534984;5463.098588732894;5520.3651580068;5521.254630624894;5522.5581953443625;3433.6051354094348;3551.733619978512;3587.892363229107;3611.368010598161;3638.199596088856;1017.7353887989102;1039.1011774814806;1042.3745752548487;1051.910587600055;1057.122588251757;11814.88185118155;11829.290242585472;11846.111541634325;11854.466549005316;11897.94051029748;4817.301491283744;4883.829065982744;4934.087193869145;4971.850844474671;4999.200127979506;10112.494375281207;10115.39307641544;10125.797484050277;10133.240006999356;10133.594656213816;4719.858404247878;5485.396606373296;5522.530584900248;5536.197251398525;5564.248826408464;4346.304591265382;4525.411696479502;4525.434320709911;4527.59251667345;4578.5421457853945;3735.43968404736;3909.1204478992;3979.900502487461;3995.860144894973;3997.4803275574573;1232.5501192064833;1298.2405292903757;1299.2529295655036;1306.2489068785487;1307.8234438350892;1329.8537160912292;1334.793107068406;1363.1071648070529;1396;1399.1255465334166;7962.283394494523;8159.83680326402;8162.632681529345;8205.179482051746;8285.295749861209;1184.6327638432113;1201.0151675626078;1201.6935681401362;1206.258151236983;1222.205566381859;6264.436200741955;6304.18045654062;6353.841153971095;6360.7137678804565;6368;10327.018933201334;10684.252102352915;10749.677509674722;10752.892471075189;10766.623168189075;10410.375377477376;10423.791524169474;10527.157827373792;10542.894571054345;10631.521581528696;8305.211004954519;8317;8345.83308333842;8396.118407567239;8415.410921235454;7810.453268271166;7859.52842829432;7865.134835168242;7914.960425198067;7925.167857374892;9231.76920576964;9416.387934784218;9491.430514169171;9534.666286679932;9639.325247232626;9613;9859.654912078044;9864.704058878246;9965.003499649976;10013.649522266685;7209.781018277326;7457.179710231979;7457.366123879531;7529.887051694339;7567.697292108254;7560.546367217985;7781.922180778346;8064.3548516119745;8316.334693224406;8324.417290789828;7404.666789994355;7422.331990120915;7424.921022113816;7495;7577.772666819784;7259.564426134449;7282.198958114709;7380.557166570023;7418;7426.4058875288765;7474.065741782278;7661.080670319375;7661.1572726998875;7688.769336919901;7723.034620672416;6992.825179370557;6994;7043.36609705129;7045.859082818418;7045.929540704732;7020.7542736004;7085.433165346657;7101.254368291255;7115.786526404217;7121.857562848818 18:06:36 INFO - PROCESS | 1674 | |4;prototype.html;264.5779980930416;328.4514860183493;329.12945259787864;334.3964144718783;339.4772051041396;6190.226221722285;6466.48268138549;6502.252240992288;6519.67401629919;6527.34726527347;6307.463865571421;6448.387403196701;6461.386168314003;6486.351364863512;6487.091807146991;4526.479454862683;4629.259318509023;4657.767111644421;4742.596879265258;4760.809567617292;3857.729958902878;4697.4832768395445;4727.479977202523;4744.525547445245;4773.546513081252;4552.749598772083;4647.581717645411;4654.557817007379;4670.229412146991;4678.789454474557;3983.4821473208444;4485.349624304474;4527.479339875924;4651.372064771246;4664.160451118797;3264.8041117532784;3989.5611482736876;3996.860109896169;4001.419794129835;4018.6383225509844;4927.6550641455115;6106.694665266719;6124.479419249369;6124.96937515314;6178.567500274982;5453.754581043862;5456.563474921997;5458.890822183574;5468.179773034037;5480.232767412565;6759.121314229119;6780.084688567079;6789.456843452562;6793.762218322385;6796.6941487632685;3715.758475699071;4273.743575385487;4466.59800617946;4468.4637843458995;4478.305862591304;7154.248803875622;7218.67515961783;7270.999999999947;7279.708811647528;7288.234735352765;3780.9432858507143;4541.704789188759;4546.090781843644;4560.247559152769;4560.498345182027;4593.012502312019;4622.121796858653;4622.745748983771;4627.444706635158;4632.698874573142;5497.862553436196;5512.6692398456225;5513.531349835229;5526.47498487643;5531.1426728857095;6712.167892644574;6846;6934.861302773917;6940.271271516519;6946.79159625212;1577.8501042400953;1586.4685330414209;1603.8315976822498;1604.310146636934;1609.251697960454;969.2827307792184;1017.5471914997755;1021.2085633633993;1036.2797855490512;1041.0422411381546;6247.687615619201;6299.149614802035;6516.739330426824;6522.5760325578685;6524.151860258136;7183.138023437221;7188.317109874553;7191.17301510333;7199.1361036675935;7205.567665940061;6499.2200935887995;6504.317046710027;6509.674516274167;6518.217813862367;6532.281449040602;3736.682381997506;3797.3924172132324;3800.3539398302355;3801.4867992820614;3809.6190380961684;6061.848453788691;7174.600952814256;7463.664135113824;7538.849223015509;7539.849203015909;7358.41132709382;7376.7786966391095;7392.667329970164;7399.519031262951;7412.888806667796;7452.06849143857;7456.925430745623;7468.663910123949;7489.138749043821;7502.062242219723;6933.093848226354;7143.642817858982;7177.066981292399;7185.604791736505;7194.820129496595;6941.132358455193;7008.983697363956;7023.719051238098;7047.964760176372;7056.435485161277;7376.7049318026675;7382;7430.879030807182;7440.255974402517;7491.213422590768;3746.6253374662315;4537.4328208973875;4542.568455996675;4553.886152846206;4557.908841823211;5911;6883.65581720922;7031.613261270679;7037.859242815218;7069.081019467436;5535.450073979292;5865.3254875689845;6541.149650545399;6779.661016949034;6808.761693340709;6878.209005964378;6920.9307906920285;6921.515493915377;6924.480663950325;6927.099477067949;6730.360615741497;6760.391564759196;6763.492738044568;6773.356531129535;6775.288594697683;6860.216343750761;6897.55165914214;6900.171979362509;6913.274106218774;6917.792466226021;5471.972640136773;6482.611043337415;6523.217213934358;6639.435647969976;6795.762148324785 18:06:36 INFO - PROCESS | 1674 | |5;yui.html;748.9477284415399;756.557413912861;757.1784613694142;765.2424100140861;766.5439063757062;13688.110272832258;13711.725765484684;13896;13896.58310250693;13965.441382344694;13916.58250252494;13952.441902323895;13991.720165596682;14033.228172450512;14054.086484378533;715.8568286342726;730.0800990751665;730.3572855886812;730.9049823522935;900.9594568244412;723.8697034533808;730.1785491322263;914.6844338703137;916.5737931861682;918;970.6699722094487;975;976.6581696406272;981.6122631560529;982.7788747531783;969.5346233807777;971.1550950672889;971.4414211828192;971.9562619682096;973.0075323170397;568.0400123790822;699.4439420660588;714.17156098925;715.4240836126916;716.5056111283197;15189.088654680754;15213.771793423108;15240.923795381063;15273;15279.923600382039;12471.376431178405;12595.24428534291;12683;12803.743925121445;12828.551000715024;9934.354266972623;10106.292559520836;10139.340942838766;10641.73395665107;10927.890721092846;3220.581324427833;3651.963480365189;3731.8134093295225;3740.989932718178;3834.578196398394;83996.58001710013;84534.57732711358;85186.57406712988;85486.5725671374;85549.57225213897;8231.46495477792;9743.269254805919;9747.3664211826;9758.853617195606;9886.906033168292;22573.774262257495;22605.869706514608;22651;22690.43273918165;22699.88650056739;7504.699812007568;7573.091229052549;7610.1628820829665;7650.208150364467;7667.424943129176;3993.7603743775467;4050.8379664813665;4063.553009168989;4074.246264441088;4097.201045796041;3580.2481478889204;3587.7667951583585;3631.5642122945414;3633.9818300908855;3642.21692336149;669.0633113640941;670.7115940145686;674.3391476353202;683.111954459201;683.950136540408;572.2246356187306;587.6738410182389;597.4682532546037;598.3268822574604;603.9818805435845;6949.93050069503;7951.562664053533;8036.799080022929;8038.517688938682;8148.959255203805;587.2659176029963;592.1650472833285;601.485729701108;605.5397897597858;621.1459243540132;3762.4544441055896;3831.616838316146;3865.5168103987003;3914.5498267699577;4079.224947260011;86445;86538.56730716306;88958;89975.55012224897;92586.07413925909;80289.19710802817;81124.18875811166;81682;81770.59114704389;81952.77070843942;51906.480935190164;67736.98394524086;69140;69770;70702.64648676723;6779.6271205084195;7638.50349727266;7726.1501234865245;7999.841489208735;8168.795780105307;46683.76658116824;46748.532514674414;47199;48092.519074808806;48708;62995;64964.675176623816;65674;66118;66825.99761003492;9031.593578289125;10213.795724085625;10342.482875856327;11027.944860275647;11244.550217991517;11808.350540720343;11851.644450666494;12116;12175.208611440228;12379.319137447526;9608.711738647851;11066.170037247077;11188.552457901918;11262.099032077578;11337.773244535229;11060.834087488533;11328.376939268419;12208.450619721956;12214.57248996281;12283.201591896499;11062.336259824437;11090.279131856403;11115.444227788417;11290;11290.322580645188;9577.329586928849;9582.568784404857;9813.313068085166;9861.425071233738;10034.548445319831;8987.865182022144;9017.368784185044;9269.44383337002;9771.609135634495;9802.754931126494 18:06:36 INFO - PROCESS | 1674 | __end_tp_report 18:06:36 INFO - PROCESS | 1674 | __start_cc_report 18:06:36 INFO - PROCESS | 1674 | _x_x_mozilla_cycle_collect,1215 18:06:36 INFO - PROCESS | 1674 | __end_cc_report 18:06:36 INFO - PROCESS | 1674 | __startTimestamp1457661996246__endTimestamp 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - PROCESS | 1674 | ------- Summary: start ------- 18:06:36 INFO - PROCESS | 1674 | Number of tests: 6 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - PROCESS | 1674 | [#0] dojo.html Cycles:165 Average:5714.38 Median:5955.40 stddev:681.82 (11.4%) stddev-sans-first:647.65 18:06:36 INFO - PROCESS | 1674 | Values: 2917.4 2949.7 3507.3 3533.5 3595.9 5489.5 5613.6 5675.6 5678.2 5693.8 4332.5 5629.9 5670.7 5694.9 5723.7 5105.4 5106.5 5129.9 5146.4 5317.4 5206.2 5238.4 5268.6 5276.4 5281.8 5045.4 5073.2 5153.8 5190.9 5235.5 5164.6 5178.1 5195.5 5198.2 5210.9 5107.2 5141.9 5152.9 5158.3 5176.0 4485.4 5528.4 5607.9 5636.9 5640.7 6210.7 6246.2 6268.0 6276.4 6279.4 6246.8 6298.1 6303.1 6306.9 6326.8 4590.5 5737.3 5761.0 5800.7 5833.0 6261.9 6289.9 6290.4 6305.8 6313.1 6109.7 6116.3 6169.4 6169.5 6188.4 6077.3 6143.2 6159.5 6255.8 6279.2 6225.8 6226.1 6228.4 6235.8 6241.2 6215.9 6236.3 6250.6 6251.0 6259.7 4799.2 4815.6 4888.1 4890.8 4916.0 4312.9 4404.5 4432.9 4434.2 4452.3 5671.2 5674.0 5677.0 5677.9 5688.4 6108.6 6203.1 6239.1 6255.7 6275.0 5718.5 5724.8 5740.8 5743.3 5748.3 5218.7 5340.5 5361.1 5362.6 5371.9 6257.2 6299.3 6335.0 6338.5 6343.9 6278.8 6279.3 6282.3 6286.3 6298.6 6222.8 6257.2 6316.4 6318.7 6332.5 6122.1 6229.3 6245.0 6247.9 6252.9 6244.9 6275.7 6279.5 6283.5 6302.2 5951.1 5952.2 6070.9 6146.4 6163.8 6120.4 6126.9 6137.1 6141.7 6151.7 5930.6 5954.9 5955.3 5955.4 5962.0 5925.5 5936.2 6059.0 6091.1 6119.0 5967.9 5968.7 5982.2 5987.6 5988.3 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - PROCESS | 1674 | [#1] ext.html Cycles:180 Average:57874.10 Median:21707.93 stddev:113155.61 (521.3%) stddev-sans-first:113391.07 18:06:36 INFO - PROCESS | 1674 | Values: 509.0 531.0 583.0 630.1 639.5 39041.0 39502.0 39506.4 39545.6 39663.0 42438.6 42915.8 42923.8 42951.6 43087.6 9476.9 9699.7 9710.2 9723.2 9724.1 9550.1 9689.2 9690.1 9691.9 9704.5 9791.1 9860.7 9885.8 9887.2 9897.4 9772.2 9853.0 9856.8 9882.9 9883.5 9555.6 9704.1 9704.6 9721.0 9725.7 40701.0 41073.2 41087.8 41089.2 41203.8 3413.1 3510.5 3769.5 3783.5 3913.9 26801.9 26992.3 27607.6 29729.3 29964.1 2705.3 2755.8 2802.6 2826.2 2931.1 347709.0 349722.0 350008.2 350293.0 350316.0 59154.7 59577.4 59840.0 59910.0 60018.7 62437.7 62509.7 65892.7 66386.0 66575.0 17243.0 17474.9 17492.0 17497.7 17524.1 13220.2 13288.2 13301.0 13317.1 13324.2 19300.8 20195.2 20222.1 20260.2 20272.6 7925.2 8083.6 8730.4 8768.9 8792.7 951.0 979.3 997.9 999.8 1071.8 28460.0 28744.1 28970.8 29006.6 29299.3 905.3 1057.2 1133.6 1134.7 1190.3 14599.9 14609.8 14691.2 14945.6 14969.2 481401.0 484937.0 487648.0 489606.0 489837.0 57740.0 58824.4 58907.0 58910.7 58919.7 1334.1 1365.6 1366.4 1422.2 1439.4 29346.4 29509.9 29592.3 30371.7 30456.5 39558.6 48991.0 49583.5 49590.5 49639.8 428740.0 435509.0 435860.0 436053.0 436111.0 31338.1 31989.5 32499.2 32532.0 32567.7 43519.8 43635.3 43730.8 44216.8 45084.8 36039.8 36216.5 36317.6 37217.1 37287.6 34978.0 35259.3 35854.0 35910.9 35979.8 34237.0 34864.7 35032.5 35113.8 35780.5 30630.8 31764.4 31811.8 31827.7 31954.2 22707.4 23292.8 23615.9 23840.5 24046.0 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - PROCESS | 1674 | [#2] jquery.html Cycles:180 Average:34434.88 Median:14005.10 stddev:104092.72 (743.2%) stddev-sans-first:104353.28 18:06:36 INFO - PROCESS | 1674 | Values: 357.4 360.8 362.4 367.8 374.0 20080.5 20511.0 21755.0 22061.7 22126.6 20209.6 20211.0 20861.0 20921.1 21305.6 5880.9 6041.6 6050.8 6099.5 6104.1 5663.9 5992.4 5996.7 6014.4 6014.8 5921.9 5933.3 5934.1 5938.7 5941.3 5203.5 5614.7 5906.1 5983.3 5987.9 5135.5 5168.4 5172.6 5173.1 5175.0 25708.9 26108.5 26583.9 26648.0 26676.1 1878.1 2039.4 2118.9 2233.0 2301.3 10088.6 10232.0 12450.3 12915.9 14923.3 1747.1 1808.9 1843.6 1860.9 1891.2 66349.0 93936.0 97899.0 100532.0 105838.0 11213.3 11303.7 11411.7 11415.4 11559.4 12221.3 12602.8 12918.4 13400.6 13424.3 6538.8 6637.8 8115.6 8630.4 8743.2 8811.6 8839.8 8852.2 8966.5 8982.0 4435.7 4537.8 4549.4 4558.9 4597.3 1850.7 1888.2 1890.1 1891.8 1894.0 905.5 978.1 983.8 998.9 1041.9 17688.5 19407.0 19726.0 19961.2 20028.0 840.4 944.4 969.6 978.1 984.8 10353.3 10777.5 10781.8 10868.0 10887.2 602043.0 620023.0 626998.0 651156.0 651370.0 112335.0 112423.0 113128.0 115283.4 117642.0 1008.7 1022.4 1032.0 1036.7 1039.1 13071.7 17329.9 17473.4 18005.7 18010.9 45435.4 47109.8 47280.3 48174.8 49158.0 69099.0 69635.7 69729.7 69917.0 70350.0 7018.7 7680.1 8018.8 8064.1 8148.4 9511.3 10252.6 12625.3 13397.7 13786.7 11483.9 11736.8 11851.9 11946.3 12038.3 10266.6 11382.3 11508.2 11687.1 11924.0 11720.0 11825.8 11906.4 12045.6 12196.5 8162.5 8201.1 8223.3 8334.7 8544.0 9828.8 10452.7 11858.3 11963.9 12052.1 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - PROCESS | 1674 | [#3] mootools.html Cycles:180 Average:6048.13 Median:4985.53 stddev:3162.21 (63.4%) stddev-sans-first:3152.11 18:06:36 INFO - PROCESS | 1674 | Values: 1440.6 1568.1 1593.7 1890.8 2029.5 7936.5 8572.8 8742.7 8747.0 8749.5 8407.2 8674.3 8679.8 8688.4 8697.4 2169.8 2395.6 2447.9 2468.3 2479.7 2485.4 2495.8 2496.7 2497.1 2501.1 2397.7 2463.3 2486.5 2488.4 2488.7 2441.5 2468.1 2481.4 2487.9 2492.8 2041.9 2434.0 2476.6 2478.3 2484.6 8711.9 8798.3 8798.7 8801.9 8812.9 5349.9 5463.1 5520.4 5521.3 5522.6 3433.6 3551.7 3587.9 3611.4 3638.2 1017.7 1039.1 1042.4 1051.9 1057.1 11814.9 11829.3 11846.1 11854.5 11897.9 4817.3 4883.8 4934.1 4971.9 4999.2 10112.5 10115.4 10125.8 10133.2 10133.6 4719.9 5485.4 5522.5 5536.2 5564.2 4346.3 4525.4 4525.4 4527.6 4578.5 3735.4 3909.1 3979.9 3995.9 3997.5 1232.6 1298.2 1299.3 1306.2 1307.8 1329.9 1334.8 1363.1 1396.0 1399.1 7962.3 8159.8 8162.6 8205.2 8285.3 1184.6 1201.0 1201.7 1206.3 1222.2 6264.4 6304.2 6353.8 6360.7 6368.0 10327.0 10684.3 10749.7 10752.9 10766.6 10410.4 10423.8 10527.2 10542.9 10631.5 8305.2 8317.0 8345.8 8396.1 8415.4 7810.5 7859.5 7865.1 7915.0 7925.2 9231.8 9416.4 9491.4 9534.7 9639.3 9613.0 9859.7 9864.7 9965.0 10013.6 7209.8 7457.2 7457.4 7529.9 7567.7 7560.5 7781.9 8064.4 8316.3 8324.4 7404.7 7422.3 7424.9 7495.0 7577.8 7259.6 7282.2 7380.6 7418.0 7426.4 7474.1 7661.1 7661.2 7688.8 7723.0 6992.8 6994.0 7043.4 7045.9 7045.9 7020.8 7085.4 7101.3 7115.8 7121.9 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - PROCESS | 1674 | [#4] prototype.html Cycles:180 Average:5583.42 Median:6474.55 stddev:1817.45 (28.1%) stddev-sans-first:1778.16 18:06:36 INFO - PROCESS | 1674 | Values: 264.6 328.5 329.1 334.4 339.5 6190.2 6466.5 6502.3 6519.7 6527.3 6307.5 6448.4 6461.4 6486.4 6487.1 4526.5 4629.3 4657.8 4742.6 4760.8 3857.7 4697.5 4727.5 4744.5 4773.5 4552.7 4647.6 4654.6 4670.2 4678.8 3983.5 4485.3 4527.5 4651.4 4664.2 3264.8 3989.6 3996.9 4001.4 4018.6 4927.7 6106.7 6124.5 6125.0 6178.6 5453.8 5456.6 5458.9 5468.2 5480.2 6759.1 6780.1 6789.5 6793.8 6796.7 3715.8 4273.7 4466.6 4468.5 4478.3 7154.2 7218.7 7271.0 7279.7 7288.2 3780.9 4541.7 4546.1 4560.2 4560.5 4593.0 4622.1 4622.7 4627.4 4632.7 5497.9 5512.7 5513.5 5526.5 5531.1 6712.2 6846.0 6934.9 6940.3 6946.8 1577.9 1586.5 1603.8 1604.3 1609.3 969.3 1017.5 1021.2 1036.3 1041.0 6247.7 6299.1 6516.7 6522.6 6524.2 7183.1 7188.3 7191.2 7199.1 7205.6 6499.2 6504.3 6509.7 6518.2 6532.3 3736.7 3797.4 3800.4 3801.5 3809.6 6061.8 7174.6 7463.7 7538.8 7539.8 7358.4 7376.8 7392.7 7399.5 7412.9 7452.1 7456.9 7468.7 7489.1 7502.1 6933.1 7143.6 7177.1 7185.6 7194.8 6941.1 7009.0 7023.7 7048.0 7056.4 7376.7 7382.0 7430.9 7440.3 7491.2 3746.6 4537.4 4542.6 4553.9 4557.9 5911.0 6883.7 7031.6 7037.9 7069.1 5535.5 5865.3 6541.1 6779.7 6808.8 6878.2 6920.9 6921.5 6924.5 6927.1 6730.4 6760.4 6763.5 6773.4 6775.3 6860.2 6897.6 6900.2 6913.3 6917.8 5472.0 6482.6 6523.2 6639.4 6795.8 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - PROCESS | 1674 | [#5] yui.html Cycles:180 Average:18130.14 Median:63979.84 stddev:25552.46 (39.9%) stddev-sans-first:25590.81 18:06:36 INFO - PROCESS | 1674 | Values: 748.9 756.6 757.2 765.2 766.5 13688.1 13711.7 13896.0 13896.6 13965.4 13916.6 13952.4 13991.7 14033.2 14054.1 715.9 730.1 730.4 730.9 901.0 723.9 730.2 914.7 916.6 918.0 970.7 975.0 976.7 981.6 982.8 969.5 971.2 971.4 972.0 973.0 568.0 699.4 714.2 715.4 716.5 15189.1 15213.8 15240.9 15273.0 15279.9 12471.4 12595.2 12683.0 12803.7 12828.6 9934.4 10106.3 10139.3 10641.7 10927.9 3220.6 3652.0 3731.8 3741.0 3834.6 83996.6 84534.6 85186.6 85486.6 85549.6 8231.5 9743.3 9747.4 9758.9 9886.9 22573.8 22605.9 22651.0 22690.4 22699.9 7504.7 7573.1 7610.2 7650.2 7667.4 3993.8 4050.8 4063.6 4074.2 4097.2 3580.2 3587.8 3631.6 3634.0 3642.2 669.1 670.7 674.3 683.1 684.0 572.2 587.7 597.5 598.3 604.0 6949.9 7951.6 8036.8 8038.5 8149.0 587.3 592.2 601.5 605.5 621.1 3762.5 3831.6 3865.5 3914.5 4079.2 86445.0 86538.6 88958.0 89975.6 92586.1 80289.2 81124.2 81682.0 81770.6 81952.8 51906.5 67737.0 69140.0 69770.0 70702.6 6779.6 7638.5 7726.2 7999.8 8168.8 46683.8 46748.5 47199.0 48092.5 48708.0 62995.0 64964.7 65674.0 66118.0 66826.0 9031.6 10213.8 10342.5 11027.9 11244.6 11808.4 11851.6 12116.0 12175.2 12379.3 9608.7 11066.2 11188.6 11262.1 11337.8 11060.8 11328.4 12208.5 12214.6 12283.2 11062.3 11090.3 11115.4 11290.0 11290.3 9577.3 9582.6 9813.3 9861.4 10034.5 8987.9 9017.4 9269.4 9771.6 9802.8 18:06:36 INFO - PROCESS | 1674 | -------- Summary: end -------- 18:06:36 INFO - PROCESS | 1674 | 18:06:36 INFO - TEST-INFO | 1674: exit 0 18:06:36 INFO - TEST-OK | dromaeo_css | took 1113323ms 18:06:36 INFO - TEST-START | kraken 18:06:36 INFO - operating with platform_type : mac_ 18:06:36 INFO - Initialising browser for kraken test... 18:06:36 INFO - TEST-INFO | started process 1680 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/tmpKplt9d/profile http://localhost:49271/getInfo.html) 18:06:38 INFO - PROCESS | 1680 | __metrics Screen width/height:1600/1200 18:06:38 INFO - PROCESS | 1680 | colorDepth:24 18:06:38 INFO - PROCESS | 1680 | Browser inner width/height: 1024/689 18:06:38 INFO - PROCESS | 1680 | __metrics 18:06:39 INFO - PROCESS | 1680 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 18:06:39 ERROR - PROCESS | 1680 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 18:06:39 INFO - TEST-INFO | 1680: exit 0 18:06:39 INFO - Browser initialized. 18:06:39 INFO - Running cycle 1/1 for kraken test... 18:06:39 INFO - TEST-INFO | started process 1682 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/tmpKplt9d/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:06:51 INFO - PROCESS | 1682 | RSS: Main: 243355648 18:06:51 INFO - PROCESS | 1682 | 18:06:54 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-beat-detection) 18:06:54 INFO - PROCESS | 1682 | RSS: Main: 288813056 18:06:54 INFO - PROCESS | 1682 | 18:06:57 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-dft) 18:06:58 INFO - PROCESS | 1682 | RSS: Main: 299319296 18:06:58 INFO - PROCESS | 1682 | 18:07:01 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-fft) 18:07:01 INFO - PROCESS | 1682 | RSS: Main: 284835840 18:07:01 INFO - PROCESS | 1682 | 18:07:03 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-oscillator) 18:07:04 INFO - PROCESS | 1682 | RSS: Main: 288231424 18:07:04 INFO - PROCESS | 1682 | 18:07:06 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:07:07 INFO - PROCESS | 1682 | RSS: Main: 287334400 18:07:07 INFO - PROCESS | 1682 | 18:07:09 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-darkroom) 18:07:10 INFO - PROCESS | 1682 | RSS: Main: 289808384 18:07:10 INFO - PROCESS | 1682 | 18:07:13 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-desaturate) 18:07:13 INFO - PROCESS | 1682 | RSS: Main: 289718272 18:07:13 INFO - PROCESS | 1682 | 18:07:16 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49271/tests/kraken/driver.html?testName=json-parse-financial) 18:07:17 INFO - PROCESS | 1682 | RSS: Main: 289406976 18:07:17 INFO - PROCESS | 1682 | 18:07:18 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49271/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:07:19 INFO - PROCESS | 1682 | RSS: Main: 325255168 18:07:19 INFO - PROCESS | 1682 | 18:07:21 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:07:21 INFO - PROCESS | 1682 | RSS: Main: 324153344 18:07:21 INFO - PROCESS | 1682 | 18:07:23 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:07:24 INFO - PROCESS | 1682 | RSS: Main: 330330112 18:07:24 INFO - PROCESS | 1682 | 18:07:26 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:07:27 INFO - PROCESS | 1682 | RSS: Main: 330612736 18:07:27 INFO - PROCESS | 1682 | 18:07:30 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:07:30 INFO - PROCESS | 1682 | RSS: Main: 331993088 18:07:30 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49271/tests/kraken/driver.html?testName=ai-astar) 18:07:32 INFO - PROCESS | 1682 | RSS: Main: 391544832 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | __start_tp_report 18:07:32 INFO - PROCESS | 1682 | _x_x_mozilla_page_load 18:07:32 INFO - PROCESS | 1682 | _x_x_mozilla_page_load_details 18:07:32 INFO - PROCESS | 1682 | |i|pagename|runs| 18:07:32 INFO - PROCESS | 1682 | |0;ai-astar;111;106;111;109;115;158;170;109;110;111 18:07:32 INFO - PROCESS | 1682 | |1;audio-beat-detection;142;119;136;146;116;132;115;153;149;141 18:07:32 INFO - PROCESS | 1682 | |2;audio-dft;186;182;185;180;181;184;184;181;181;180 18:07:32 INFO - PROCESS | 1682 | |3;audio-fft;75;80;83;77;55;57;58;78;76;55 18:07:32 INFO - PROCESS | 1682 | |4;audio-oscillator;95;98;130;80;76;83;118;78;81;114 18:07:32 INFO - PROCESS | 1682 | |5;imaging-gaussian-blur;87;84;87;84;87;84;87;86;135;84 18:07:32 INFO - PROCESS | 1682 | |6;imaging-darkroom;142;110;93;94;93;92;93;93;93;92 18:07:32 INFO - PROCESS | 1682 | |7;imaging-desaturate;91;91;88;93;92;93;87;94;89;87 18:07:32 INFO - PROCESS | 1682 | |8;json-parse-financial;54;56;56;55;56;54;54;63;55;53 18:07:32 INFO - PROCESS | 1682 | |9;json-stringify-tinderbox;64;70;73;70;69;68;67;67;66;66 18:07:32 INFO - PROCESS | 1682 | |10;stanford-crypto-aes;84;84;83;83;83;89;80;83;82;83 18:07:32 INFO - PROCESS | 1682 | |11;stanford-crypto-ccm;120;124;117;119;120;118;125;122;128;119 18:07:32 INFO - PROCESS | 1682 | |12;stanford-crypto-pbkdf2;137;128;141;137;139;126;135;138;137;141 18:07:32 INFO - PROCESS | 1682 | |13;stanford-crypto-sha256-iterative;67;67;66;68;67;67;81;96;95;91 18:07:32 INFO - PROCESS | 1682 | __end_tp_report 18:07:32 INFO - PROCESS | 1682 | __start_cc_report 18:07:32 INFO - PROCESS | 1682 | _x_x_mozilla_cycle_collect,1213 18:07:32 INFO - PROCESS | 1682 | __end_cc_report 18:07:32 INFO - PROCESS | 1682 | __startTimestamp1457662052679__endTimestamp 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | ------- Summary: start ------- 18:07:32 INFO - PROCESS | 1682 | Number of tests: 14 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#0] ai-astar Cycles:10 Average:121.00 Median:111.00 stddev:22.95 (20.7%) stddev-sans-first:24.05 18:07:32 INFO - PROCESS | 1682 | Values: 111.0 106.0 111.0 109.0 115.0 158.0 170.0 109.0 110.0 111.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#1] audio-beat-detection Cycles:10 Average:134.90 Median:141.50 stddev:13.96 (9.9%) stddev-sans-first:14.56 18:07:32 INFO - PROCESS | 1682 | Values: 142.0 119.0 136.0 146.0 116.0 132.0 115.0 153.0 149.0 141.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#2] audio-dft Cycles:10 Average:182.40 Median:183.00 stddev:2.17 (1.2%) stddev-sans-first:1.87 18:07:32 INFO - PROCESS | 1682 | Values: 186.0 182.0 185.0 180.0 181.0 184.0 184.0 181.0 181.0 180.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#3] audio-fft Cycles:10 Average:69.40 Median:76.50 stddev:11.56 (15.1%) stddev-sans-first:12.08 18:07:32 INFO - PROCESS | 1682 | Values: 75.0 80.0 83.0 77.0 55.0 57.0 58.0 78.0 76.0 55.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#4] audio-oscillator Cycles:10 Average:95.30 Median:80.50 stddev:19.26 (23.9%) stddev-sans-first:20.43 18:07:32 INFO - PROCESS | 1682 | Values: 95.0 98.0 130.0 80.0 76.0 83.0 118.0 78.0 81.0 114.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#5] imaging-gaussian-blur Cycles:10 Average:90.50 Median:86.50 stddev:15.70 (18.2%) stddev-sans-first:16.60 18:07:32 INFO - PROCESS | 1682 | Values: 87.0 84.0 87.0 84.0 87.0 84.0 87.0 86.0 135.0 84.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#6] imaging-darkroom Cycles:10 Average:99.50 Median:93.00 stddev:15.88 (17.1%) stddev-sans-first:5.74 18:07:32 INFO - PROCESS | 1682 | Values: 142.0 110.0 93.0 94.0 93.0 92.0 93.0 93.0 93.0 92.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#7] imaging-desaturate Cycles:10 Average:90.50 Median:91.50 stddev:2.59 (2.8%) stddev-sans-first:2.74 18:07:32 INFO - PROCESS | 1682 | Values: 91.0 91.0 88.0 93.0 92.0 93.0 87.0 94.0 89.0 87.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#8] json-parse-financial Cycles:10 Average:55.60 Median:55.50 stddev:2.80 (5.0%) stddev-sans-first:2.91 18:07:32 INFO - PROCESS | 1682 | Values: 54.0 56.0 56.0 55.0 56.0 54.0 54.0 63.0 55.0 53.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#9] json-stringify-tinderbox Cycles:10 Average:68.00 Median:68.50 stddev:2.58 (3.8%) stddev-sans-first:2.30 18:07:32 INFO - PROCESS | 1682 | Values: 64.0 70.0 73.0 70.0 69.0 68.0 67.0 67.0 66.0 66.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#10] stanford-crypto-aes Cycles:10 Average:83.40 Median:83.00 stddev:2.27 (2.7%) stddev-sans-first:2.40 18:07:32 INFO - PROCESS | 1682 | Values: 84.0 84.0 83.0 83.0 83.0 89.0 80.0 83.0 82.0 83.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#11] stanford-crypto-ccm Cycles:10 Average:121.20 Median:121.00 stddev:3.49 (2.9%) stddev-sans-first:3.67 18:07:32 INFO - PROCESS | 1682 | Values: 120.0 124.0 117.0 119.0 120.0 118.0 125.0 122.0 128.0 119.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:135.90 Median:137.50 stddev:5.07 (3.7%) stddev-sans-first:5.36 18:07:32 INFO - PROCESS | 1682 | Values: 137.0 128.0 141.0 137.0 139.0 126.0 135.0 138.0 137.0 141.0 18:07:32 INFO - PROCESS | 1682 | 18:07:32 INFO - PROCESS | 1682 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:76.50 Median:74.50 stddev:12.89 (17.3%) stddev-sans-first:13.21 18:07:32 INFO - PROCESS | 1682 | Values: 67.0 67.0 66.0 68.0 67.0 67.0 81.0 96.0 95.0 91.0 18:07:32 INFO - PROCESS | 1682 | -------- Summary: end -------- 18:07:32 INFO - PROCESS | 1682 | 18:07:33 INFO - TEST-INFO | 1682: exit 0 18:07:33 INFO - TEST-OK | kraken | took 56658ms 18:07:33 INFO - SUITE-END | took 1169s 18:07:33 INFO - Completed test suite (00:19:30) 18:07:33 INFO - javascript benchmark 18:07:33 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2917.372764855556, 2949.675535691075, 3507.3160733656932, 3533.4523148911926, 3595.9460608090867, 5489.533389661883, 5613.550915926727, 5675.574331925107, 5678.176664383662, 5693.800716974902, 4332.458442694663, 5629.887402251952, 5670.659760414378, 5694.943050569493, 5723.713814309289, 5105.4128775190775, 5106.514881086291, 5129.948700512984, 5146.356705411824, 5317.415084340739, 5206.245094461301, 5238.3975842778, 5268.631195816294, 5276.419593844674, 5281.815136470224, 5045.4197767256865, 5073.239014147871, 5153.768080436389, 5190.88395994861, 5235.502627250406, 5164.561012313958, 5178.093833579109, 5195.532402083831, 5198.16829307309, 5210.921836172461, 5107.208382700687, 5141.922871156936, 5152.92270615941, 5158.2520534522655, 5175.974120129413, 4485.372047913294, 5528.419515950807, 5607.934492446422, 5636.859078523029, 5640.661560306395, 6210.689465526705, 6246.187995560594, 6267.9686601567155, 6276.435120839146, 6279.37206279373, 6246.843828904268, 6298.149749783766, 6303.149074874879, 6306.873862522724, 6326.778562750328, 4590.472095708969, 5737.254156959611, 5760.971195143998, 5800.7099645018425, 5833.0, 6261.9373806262265, 6289.937100628935, 6290.433860952537, 6305.8108256752375, 6313.116163737081, 6109.694515274218, 6116.26604807426, 6169.413905679043, 6169.475594574512, 6188.44304012641, 6077.301110372276, 6143.204841796972, 6159.538034647419, 6255.78104766331, 6279.183706118175, 6225.750969961151, 6226.128342032119, 6228.439440450381, 6235.750569977241, 6241.21984751906, 6215.9378406216265, 6236.314005459396, 6250.593711408744, 6250.968745156245, 6259.6870156492, 4799.160146974265, 4815.614750819926, 4888.120138375056, 4890.755462226945, 4915.975420122876, 4312.892177695583, 4404.53752355998, 4432.889177770581, 4434.246178149722, 4452.287633978548, 5671.234383358194, 5673.971630141823, 5677.0, 5677.943220567824, 5688.402717714663, 6108.584917381041, 6203.131561581382, 6239.0953311770445, 6255.6872156392, 6275.027370757449, 5718.485336319668, 5724.77100915967, 5740.827775166752, 5743.339515955635, 5748.338941021752, 5218.6868787872845, 5340.49265319794, 5361.061814182581, 5362.570994320445, 5371.865703357447, 6257.186565746424, 6299.307076221612, 6334.9683251584365, 6338.492920566436, 6343.8898192817, 6278.8430289241305, 6279.30927597973, 6282.340354262919, 6286.308506064238, 6298.622082675054, 6222.782202622887, 6257.2491301044165, 6316.368363163647, 6318.747250109944, 6332.493400528039, 6122.123717501779, 6229.283632382334, 6244.969580019246, 6247.937520624736, 6252.937470625236, 6244.906326405198, 6275.654838983717, 6279.497640188865, 6283.497320214463, 6302.180716506825, 5951.1073338999495, 5952.226210592596, 6070.878582428415, 6146.385361463997, 6163.7842675506145, 6120.386183820725, 6126.914660831567, 6137.065116418418, 6141.723622436912, 6151.661658608819, 5930.555208359477, 5954.880902381841, 5955.255593050869, 5955.40445955401, 5962.0, 5925.466707996301, 5936.22829032223, 6058.969705151446, 6091.086337049478, 6118.969405153124, 5967.940320596738, 5968.6717230551, 5982.162497250475, 5987.5808693391045, 5988.28140623128], "unit": "score", "name": "dojo.html", "value": 5669.28683649437}, {"lowerIsBetter": false, "replicates": [508.9921954530028, 530.9752178295887, 583.0292562882801, 630.1209812311826, 639.4820195641529, 39041.0, 39502.0, 39506.407403888894, 39545.60454395455, 39663.0, 42438.57561424385, 42915.78542107285, 42923.78538107305, 42951.570484295145, 43087.56912430875, 9476.905230947688, 9699.660511882086, 9710.223182145412, 9723.173530249902, 9724.124828765409, 9550.092741189575, 9689.176420004309, 9690.12788849007, 9691.854622180674, 9704.466254356008, 9791.069848364394, 9860.654877079303, 9885.75285617858, 9887.159591434736, 9897.406155630686, 9772.218222542215, 9853.014698530089, 9856.802863942718, 9882.901170988305, 9883.456409897453, 9555.569999350046, 9704.126628603459, 9704.563294651758, 9720.951395242979, 9725.6596019139, 40701.0, 41073.178536429405, 41087.7945610273, 41089.1782164355, 41203.793981030205, 3413.112590726404, 3510.473428985647, 3769.491118698968, 3783.5270591176104, 3913.8630147944687, 26801.92792288306, 26992.325191870164, 27607.585886211724, 29729.25676858074, 29964.101076967727, 2705.2830999785074, 2755.8032682088683, 2802.649668791401, 2826.1662809471254, 2931.106012666136, 347709.0, 349722.0, 350008.24995875114, 350293.0, 350316.0, 59154.70422647859, 59577.40422595805, 59840.0, 59910.0, 60018.69990650019, 62437.68781156065, 62509.749805003645, 65892.67053664701, 66386.0, 66575.0, 17243.0, 17474.86413383126, 17491.950482971064, 17497.650046998988, 17524.123793810515, 13220.206787592775, 13288.202707837561, 13301.002424818178, 13317.134386265056, 13324.200547967153, 19300.8069919299, 20195.192192312144, 20222.09000594977, 20260.18959241614, 20272.594548108955, 7925.207479252029, 8083.636236369378, 8730.38887277897, 8768.868466973001, 8792.736217913473, 950.9952450237843, 979.3046936674898, 997.9201663866874, 999.7850462150527, 1071.7588542578014, 28460.0, 28744.13767586976, 28970.8406504548, 29006.564901526493, 29299.267518312212, 905.2712566384124, 1057.2335057083553, 1133.6485689436302, 1134.6652737442473, 1190.2858285029085, 14599.92700036493, 14609.78085328721, 14691.191984440959, 14945.551633451014, 14969.176695281647, 481401.0, 484937.0, 487648.0, 489606.0, 489837.0, 57740.0, 58824.41175588275, 58907.0, 58910.70544647249, 58919.70540147272, 1334.1128149780482, 1365.5698454986648, 1366.3851266929723, 1422.2391020804027, 1439.4026479011302, 29346.413071738018, 29509.852450738468, 29592.265237562748, 30371.69628303777, 30456.543151853184, 39558.604413955494, 48991.0, 49583.50416495933, 49590.51228463152, 49639.75180124076, 428740.0, 435509.0, 435860.0, 436053.0, 436111.0, 31338.05985820429, 31989.520157197196, 32499.18752031218, 32532.02403927886, 32567.67432325741, 43519.78240108779, 43635.34546981861, 43730.78134609306, 44216.7789161065, 45084.77457612691, 36039.81980090083, 36216.456753148195, 36317.63682363142, 37217.06957326089, 37287.627123728416, 34978.0, 35259.294814103065, 35854.0, 35910.92267231987, 35979.82010089933, 34237.0, 34864.65135348614, 35032.47451288182, 35113.824430877685, 35780.46329305114, 30630.846845765627, 31764.364712705155, 31811.840940795148, 31827.6817231834, 31954.20114497156, 22707.397454242655, 23292.76707232906, 23615.93728282266, 23840.523189535765, 24046.0], "unit": "score", "name": "ext.html", "value": 19538.687353261023}, {"lowerIsBetter": false, "replicates": [357.4031367616081, 360.77271319068984, 362.3803296363218, 367.78117020372866, 374.03685509812243, 20080.4979875503, 20511.0, 21755.0, 22061.669074963887, 22126.557468850613, 20209.595808083828, 20211.0, 20860.956952152406, 20921.058552365143, 21305.57388852222, 5880.882382352351, 6041.607295525799, 6050.757969681207, 6099.48154406876, 6104.053871649901, 5663.915041274384, 5992.400759924017, 5996.670183139926, 6014.428629280212, 6014.789482368118, 5921.88156236875, 5933.317668468138, 5934.050551911695, 5938.732757025944, 5941.257342832146, 5203.531682148625, 5614.719264036782, 5906.084556893646, 5983.252093488336, 5987.9101813472835, 5135.512126347991, 5168.3539557555305, 5172.6379153459275, 5173.094708426011, 5174.974125129388, 25708.871455642788, 26108.477830443473, 26583.867080664473, 26648.0, 26676.066337678087, 1878.1360574135776, 2039.3677959832498, 2118.947026324339, 2232.9888350558304, 2301.3211102724736, 10088.646897358558, 10232.02795734404, 12450.3152326622, 12915.87084129156, 14923.253837308199, 1747.1264367816093, 1808.8552915766707, 1843.6312737452563, 1860.897650629215, 1891.1678861300984, 66349.0, 93936.0, 97899.0, 100532.0, 105838.0, 11213.327200368005, 11303.660890173307, 11411.657650270505, 11415.372154531415, 11559.36423496699, 12221.266723996589, 12602.810957835456, 12918.41867115982, 13400.597982060553, 13424.328783560979, 6538.8365290868105, 6637.834054148589, 8115.594220288962, 8630.439021463584, 8743.169398907221, 8811.603477843513, 8839.823203535892, 8852.247558957431, 8966.462012279284, 8981.955090224506, 4435.711678740871, 4537.8411755588395, 4549.408576884984, 4558.908821823545, 4597.310403439444, 1850.7408962745226, 1888.2447021191633, 1890.0833095948453, 1891.848652107828, 1894.0, 905.4612505559181, 978.0708327089294, 983.7983213441228, 998.8951160128228, 1041.8749750030045, 17688.469345919642, 19407.0, 19726.0, 19961.20155193805, 20028.0, 840.369722707969, 944.367273926471, 969.5636963366513, 978.1490103609905, 984.8178087053918, 10353.256387057436, 10777.461126943621, 10781.784364312669, 10867.967543083394, 10887.18346124028, 602043.0, 620023.0, 626998.0, 651156.0, 651370.0, 112335.0, 112423.0, 113128.0, 115283.42358288154, 117642.0, 1008.6721815410021, 1022.3712416863575, 1031.9638812641522, 1036.740814796301, 1039.1063685230695, 13071.673208169872, 17329.913350433166, 17473.38843140484, 18005.729914051037, 18010.90994545019, 45435.40976065822, 47109.76445117752, 47280.34518791964, 48174.759126204146, 49158.007882480364, 69099.0, 69635.65182174057, 69729.65135174291, 69916.95124573237, 70350.0, 7018.684159212746, 7680.116786569616, 8018.83962320762, 8064.112947575879, 8148.429609927248, 9511.286653501153, 10252.615896854128, 12625.305608191638, 13397.66505837362, 13786.655333616338, 11483.94258028738, 11736.823947640622, 11851.940740296242, 11946.34295113777, 12038.277703337828, 10266.58933642646, 11382.260153090023, 11508.194426390408, 11687.123465740273, 11924.0, 11720.003799677123, 11825.763484730085, 11906.40467976615, 12045.63863084109, 12196.451159698012, 8162.469439486415, 8201.13888041771, 8223.342132629256, 8334.6666133354, 8544.017437994462, 9828.754281143028, 10452.738681533023, 11858.347790871585, 11963.923246907472, 12052.09609279325], "unit": "score", "name": "jquery.html", "value": 9406.233433578163}, {"lowerIsBetter": false, "replicates": [1440.5678296511044, 1568.1061794776974, 1593.7450007998718, 1890.7636545431822, 2029.5129168999445, 7936.52380857149, 8572.785680357987, 8742.694005709802, 8746.956265218681, 8749.475031498114, 8407.24334809867, 8674.306055515559, 8679.783005424868, 8688.43525170865, 8697.391182617204, 2169.783021697833, 2395.6047252203452, 2447.926562203132, 2468.259522143359, 2479.665245191903, 2485.378655336166, 2495.7878580320694, 2496.662950501677, 2497.113524698724, 2501.1496091328945, 2397.7242617098996, 2463.2610216934936, 2486.5080951429177, 2488.4276616378243, 2488.726240113586, 2441.475082857194, 2468.0868078810777, 2481.367251350903, 2487.8756062196817, 2492.7881130103965, 2041.9489512762152, 2434.0263894442187, 2476.628505724138, 2478.256523043098, 2484.5527804995095, 8711.912880871174, 8798.340124490625, 8798.736037918872, 8801.867971980426, 8812.911870881273, 5349.946500534984, 5463.098588732894, 5520.3651580068, 5521.254630624894, 5522.5581953443625, 3433.6051354094348, 3551.733619978512, 3587.892363229107, 3611.368010598161, 3638.199596088856, 1017.7353887989102, 1039.1011774814806, 1042.3745752548487, 1051.910587600055, 1057.122588251757, 11814.88185118155, 11829.290242585472, 11846.111541634325, 11854.466549005316, 11897.94051029748, 4817.301491283744, 4883.829065982744, 4934.087193869145, 4971.850844474671, 4999.200127979506, 10112.494375281207, 10115.39307641544, 10125.797484050277, 10133.240006999356, 10133.594656213816, 4719.858404247878, 5485.396606373296, 5522.530584900248, 5536.197251398525, 5564.248826408464, 4346.304591265382, 4525.411696479502, 4525.434320709911, 4527.59251667345, 4578.5421457853945, 3735.43968404736, 3909.1204478992, 3979.900502487461, 3995.860144894973, 3997.4803275574573, 1232.5501192064833, 1298.2405292903757, 1299.2529295655036, 1306.2489068785487, 1307.8234438350892, 1329.8537160912292, 1334.793107068406, 1363.1071648070529, 1396.0, 1399.1255465334166, 7962.283394494523, 8159.83680326402, 8162.632681529345, 8205.179482051746, 8285.295749861209, 1184.6327638432113, 1201.0151675626078, 1201.6935681401362, 1206.258151236983, 1222.205566381859, 6264.436200741955, 6304.18045654062, 6353.841153971095, 6360.7137678804565, 6368.0, 10327.018933201334, 10684.252102352915, 10749.677509674722, 10752.892471075189, 10766.623168189075, 10410.375377477376, 10423.791524169474, 10527.157827373792, 10542.894571054345, 10631.521581528696, 8305.211004954519, 8317.0, 8345.83308333842, 8396.118407567239, 8415.410921235454, 7810.453268271166, 7859.52842829432, 7865.134835168242, 7914.960425198067, 7925.167857374892, 9231.76920576964, 9416.387934784218, 9491.430514169171, 9534.666286679932, 9639.325247232626, 9613.0, 9859.654912078044, 9864.704058878246, 9965.003499649976, 10013.649522266685, 7209.781018277326, 7457.179710231979, 7457.366123879531, 7529.887051694339, 7567.697292108254, 7560.546367217985, 7781.922180778346, 8064.3548516119745, 8316.334693224406, 8324.417290789828, 7404.666789994355, 7422.331990120915, 7424.921022113816, 7495.0, 7577.772666819784, 7259.564426134449, 7282.198958114709, 7380.557166570023, 7418.0, 7426.4058875288765, 7474.065741782278, 7661.080670319375, 7661.1572726998875, 7688.769336919901, 7723.034620672416, 6992.825179370557, 6994.0, 7043.36609705129, 7045.859082818418, 7045.929540704732, 7020.7542736004, 7085.433165346657, 7101.254368291255, 7115.786526404217, 7121.857562848818], "unit": "score", "name": "mootools.html", "value": 4951.173692586925}, {"lowerIsBetter": false, "replicates": [264.5779980930416, 328.4514860183493, 329.12945259787864, 334.3964144718783, 339.4772051041396, 6190.226221722285, 6466.48268138549, 6502.252240992288, 6519.67401629919, 6527.34726527347, 6307.463865571421, 6448.387403196701, 6461.386168314003, 6486.351364863512, 6487.091807146991, 4526.479454862683, 4629.259318509023, 4657.767111644421, 4742.596879265258, 4760.809567617292, 3857.729958902878, 4697.4832768395445, 4727.479977202523, 4744.525547445245, 4773.546513081252, 4552.749598772083, 4647.581717645411, 4654.557817007379, 4670.229412146991, 4678.789454474557, 3983.4821473208444, 4485.349624304474, 4527.479339875924, 4651.372064771246, 4664.160451118797, 3264.8041117532784, 3989.5611482736876, 3996.860109896169, 4001.419794129835, 4018.6383225509844, 4927.6550641455115, 6106.694665266719, 6124.479419249369, 6124.96937515314, 6178.567500274982, 5453.754581043862, 5456.563474921997, 5458.890822183574, 5468.179773034037, 5480.232767412565, 6759.121314229119, 6780.084688567079, 6789.456843452562, 6793.762218322385, 6796.6941487632685, 3715.758475699071, 4273.743575385487, 4466.59800617946, 4468.4637843458995, 4478.305862591304, 7154.248803875622, 7218.67515961783, 7270.999999999947, 7279.708811647528, 7288.234735352765, 3780.9432858507143, 4541.704789188759, 4546.090781843644, 4560.247559152769, 4560.498345182027, 4593.012502312019, 4622.121796858653, 4622.745748983771, 4627.444706635158, 4632.698874573142, 5497.862553436196, 5512.6692398456225, 5513.531349835229, 5526.47498487643, 5531.1426728857095, 6712.167892644574, 6846.0, 6934.861302773917, 6940.271271516519, 6946.79159625212, 1577.8501042400953, 1586.4685330414209, 1603.8315976822498, 1604.310146636934, 1609.251697960454, 969.2827307792184, 1017.5471914997755, 1021.2085633633993, 1036.2797855490512, 1041.0422411381546, 6247.687615619201, 6299.149614802035, 6516.739330426824, 6522.5760325578685, 6524.151860258136, 7183.138023437221, 7188.317109874553, 7191.17301510333, 7199.1361036675935, 7205.567665940061, 6499.2200935887995, 6504.317046710027, 6509.674516274167, 6518.217813862367, 6532.281449040602, 3736.682381997506, 3797.3924172132324, 3800.3539398302355, 3801.4867992820614, 3809.6190380961684, 6061.848453788691, 7174.600952814256, 7463.664135113824, 7538.849223015509, 7539.849203015909, 7358.41132709382, 7376.7786966391095, 7392.667329970164, 7399.519031262951, 7412.888806667796, 7452.06849143857, 7456.925430745623, 7468.663910123949, 7489.138749043821, 7502.062242219723, 6933.093848226354, 7143.642817858982, 7177.066981292399, 7185.604791736505, 7194.820129496595, 6941.132358455193, 7008.983697363956, 7023.719051238098, 7047.964760176372, 7056.435485161277, 7376.7049318026675, 7382.0, 7430.879030807182, 7440.255974402517, 7491.213422590768, 3746.6253374662315, 4537.4328208973875, 4542.568455996675, 4553.886152846206, 4557.908841823211, 5911.0, 6883.65581720922, 7031.613261270679, 7037.859242815218, 7069.081019467436, 5535.450073979292, 5865.3254875689845, 6541.149650545399, 6779.661016949034, 6808.761693340709, 6878.209005964378, 6920.9307906920285, 6921.515493915377, 6924.480663950325, 6927.099477067949, 6730.360615741497, 6760.391564759196, 6763.492738044568, 6773.356531129535, 6775.288594697683, 6860.216343750761, 6897.55165914214, 6900.171979362509, 6913.274106218774, 6917.792466226021, 5471.972640136773, 6482.611043337415, 6523.217213934358, 6639.435647969976, 6795.762148324785], "unit": "score", "name": "prototype.html", "value": 4977.143830928063}, {"lowerIsBetter": false, "replicates": [748.9477284415399, 756.557413912861, 757.1784613694142, 765.2424100140861, 766.5439063757062, 13688.110272832258, 13711.725765484684, 13896.0, 13896.58310250693, 13965.441382344694, 13916.58250252494, 13952.441902323895, 13991.720165596682, 14033.228172450512, 14054.086484378533, 715.8568286342726, 730.0800990751665, 730.3572855886812, 730.9049823522935, 900.9594568244412, 723.8697034533808, 730.1785491322263, 914.6844338703137, 916.5737931861682, 918.0, 970.6699722094487, 975.0, 976.6581696406272, 981.6122631560529, 982.7788747531783, 969.5346233807777, 971.1550950672889, 971.4414211828192, 971.9562619682096, 973.0075323170397, 568.0400123790822, 699.4439420660588, 714.17156098925, 715.4240836126916, 716.5056111283197, 15189.088654680754, 15213.771793423108, 15240.923795381063, 15273.0, 15279.923600382039, 12471.376431178405, 12595.24428534291, 12683.0, 12803.743925121445, 12828.551000715024, 9934.354266972623, 10106.292559520836, 10139.340942838766, 10641.73395665107, 10927.890721092846, 3220.581324427833, 3651.963480365189, 3731.8134093295225, 3740.989932718178, 3834.578196398394, 83996.58001710013, 84534.57732711358, 85186.57406712988, 85486.5725671374, 85549.57225213897, 8231.46495477792, 9743.269254805919, 9747.3664211826, 9758.853617195606, 9886.906033168292, 22573.774262257495, 22605.869706514608, 22651.0, 22690.43273918165, 22699.88650056739, 7504.699812007568, 7573.091229052549, 7610.1628820829665, 7650.208150364467, 7667.424943129176, 3993.7603743775467, 4050.8379664813665, 4063.553009168989, 4074.246264441088, 4097.201045796041, 3580.2481478889204, 3587.7667951583585, 3631.5642122945414, 3633.9818300908855, 3642.21692336149, 669.0633113640941, 670.7115940145686, 674.3391476353202, 683.111954459201, 683.950136540408, 572.2246356187306, 587.6738410182389, 597.4682532546037, 598.3268822574604, 603.9818805435845, 6949.93050069503, 7951.562664053533, 8036.799080022929, 8038.517688938682, 8148.959255203805, 587.2659176029963, 592.1650472833285, 601.485729701108, 605.5397897597858, 621.1459243540132, 3762.4544441055896, 3831.616838316146, 3865.5168103987003, 3914.5498267699577, 4079.224947260011, 86445.0, 86538.56730716306, 88958.0, 89975.55012224897, 92586.07413925909, 80289.19710802817, 81124.18875811166, 81682.0, 81770.59114704389, 81952.77070843942, 51906.480935190164, 67736.98394524086, 69140.0, 69770.0, 70702.64648676723, 6779.6271205084195, 7638.50349727266, 7726.1501234865245, 7999.841489208735, 8168.795780105307, 46683.76658116824, 46748.532514674414, 47199.0, 48092.519074808806, 48708.0, 62995.0, 64964.675176623816, 65674.0, 66118.0, 66825.99761003492, 9031.593578289125, 10213.795724085625, 10342.482875856327, 11027.944860275647, 11244.550217991517, 11808.350540720343, 11851.644450666494, 12116.0, 12175.208611440228, 12379.319137447526, 9608.711738647851, 11066.170037247077, 11188.552457901918, 11262.099032077578, 11337.773244535229, 11060.834087488533, 11328.376939268419, 12208.450619721956, 12214.57248996281, 12283.201591896499, 11062.336259824437, 11090.279131856403, 11115.444227788417, 11290.0, 11290.322580645188, 9577.329586928849, 9582.568784404857, 9813.313068085166, 9861.425071233738, 10034.548445319831, 8987.865182022144, 9017.368784185044, 9269.44383337002, 9771.609135634495, 9802.754931126494], "unit": "score", "name": "yui.html", "value": 6854.154646080939}], "name": "dromaeo_css", "value": 7486.052082665475}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 106.0, 111.0, 109.0, 115.0, 158.0, 170.0, 109.0, 110.0, 111.0], "unit": "score", "name": "ai-astar", "value": 121.0}, {"lowerIsBetter": true, "replicates": [142.0, 119.0, 136.0, 146.0, 116.0, 132.0, 115.0, 153.0, 149.0, 141.0], "unit": "score", "name": "audio-beat-detection", "value": 134.9}, {"lowerIsBetter": true, "replicates": [186.0, 182.0, 185.0, 180.0, 181.0, 184.0, 184.0, 181.0, 181.0, 180.0], "unit": "score", "name": "audio-dft", "value": 182.4}, {"lowerIsBetter": true, "replicates": [75.0, 80.0, 83.0, 77.0, 55.0, 57.0, 58.0, 78.0, 76.0, 55.0], "unit": "score", "name": "audio-fft", "value": 69.4}, {"lowerIsBetter": true, "replicates": [95.0, 98.0, 130.0, 80.0, 76.0, 83.0, 118.0, 78.0, 81.0, 114.0], "unit": "score", "name": "audio-oscillator", "value": 95.3}, {"lowerIsBetter": true, "replicates": [87.0, 84.0, 87.0, 84.0, 87.0, 84.0, 87.0, 86.0, 135.0, 84.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 90.5}, {"lowerIsBetter": true, "replicates": [142.0, 110.0, 93.0, 94.0, 93.0, 92.0, 93.0, 93.0, 93.0, 92.0], "unit": "score", "name": "imaging-darkroom", "value": 99.5}, {"lowerIsBetter": true, "replicates": [91.0, 91.0, 88.0, 93.0, 92.0, 93.0, 87.0, 94.0, 89.0, 87.0], "unit": "score", "name": "imaging-desaturate", "value": 90.5}, {"lowerIsBetter": true, "replicates": [54.0, 56.0, 56.0, 55.0, 56.0, 54.0, 54.0, 63.0, 55.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 55.6}, {"lowerIsBetter": true, "replicates": [64.0, 70.0, 73.0, 70.0, 69.0, 68.0, 67.0, 67.0, 66.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.0}, {"lowerIsBetter": true, "replicates": [84.0, 84.0, 83.0, 83.0, 83.0, 89.0, 80.0, 83.0, 82.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.4}, {"lowerIsBetter": true, "replicates": [120.0, 124.0, 117.0, 119.0, 120.0, 118.0, 125.0, 122.0, 128.0, 119.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 121.2}, {"lowerIsBetter": true, "replicates": [137.0, 128.0, 141.0, 137.0, 139.0, 126.0, 135.0, 138.0, 137.0, 141.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 135.9}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 66.0, 68.0, 67.0, 67.0, 81.0, 96.0, 95.0, 91.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 76.5}], "name": "kraken", "value": 1424.1000000000001}]} 18:07:33 INFO - Return code: 0 18:07:33 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 18:07:33 ERROR - # TBPL SUCCESS # 18:07:33 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 18:07:33 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 18:07:33 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 18:07:33 INFO - 2016-03-10 18:07:33.957 screenresolution[1686:9989] starting screenresolution argv=screenresolution get 18:07:33 INFO - 2016-03-10 18:07:33.960 screenresolution[1686:9989] Display 0: 1600x1200x32@60 18:07:33 INFO - 2016-03-10 18:07:33.966 screenresolution[1687:9992] starting screenresolution argv=screenresolution list 18:07:33 INFO - Available Modes on Display 0 18:07:33 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 18:07:33 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 18:07:33 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 18:07:33 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 18:07:34 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 18:07:34 INFO - Intel Iris: 18:07:34 INFO - Chipset Model: Intel Iris 18:07:34 INFO - Type: GPU 18:07:34 INFO - Bus: Built-In 18:07:34 INFO - VRAM (Dynamic, Max): 1536 MB 18:07:34 INFO - Vendor: Intel (0x8086) 18:07:34 INFO - Device ID: 0x0a2e 18:07:34 INFO - Revision ID: 0x0009 18:07:34 INFO - Displays: 18:07:34 INFO - Display: 18:07:34 INFO - Resolution: 1600 x 1200 @ 60 Hz 18:07:34 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 18:07:34 INFO - Display Serial Number: 1600x1200 60 18:07:34 INFO - Main Display: Yes 18:07:34 INFO - Mirror: Off 18:07:34 INFO - Online: Yes 18:07:34 INFO - Rotation: Supported 18:07:34 INFO - Return code: 0 18:07:34 INFO - Running post-action listener: _resource_record_post_action 18:07:34 INFO - Running post-run listener: _resource_record_post_run 18:07:35 INFO - Total resource usage - Wall time: 1206s; CPU: 52.0%; Read bytes: 38929920; Write bytes: 703172096; Read time: 419; Write time: 1911 18:07:35 INFO - install - Wall time: 35s; CPU: 55.0%; Read bytes: 396478976; Write bytes: 386328064; Read time: 29890; Write time: 725 18:07:35 INFO - run-tests - Wall time: 1172s; CPU: 52.0%; Read bytes: 31849984; Write bytes: 297474048; Read time: 334; Write time: 1141 18:07:35 INFO - Running post-run listener: _upload_blobber_files 18:07:35 INFO - Blob upload gear active. 18:07:35 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:07:35 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 18:07:35 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'] 18:07:35 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 18:07:35 INFO - (blobuploader) - INFO - Open directory for files ... 18:07:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 18:07:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:07:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:07:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 18:07:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:07:36 INFO - (blobuploader) - INFO - Done attempting. 18:07:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 18:07:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:07:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:07:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 18:07:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:07:37 INFO - (blobuploader) - INFO - Done attempting. 18:07:37 INFO - (blobuploader) - INFO - Iteration through files over. 18:07:38 INFO - Return code: 0 18:07:38 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:07:38 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:07:38 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9183a80006f1a98a44850d856eeaa261972567ed6db8a5fb5d3a7382d9dc9a81f6ed248466d4ceeaa52c92fe323eff3621c40b9ab1cb7aaa846eb6be75feb98a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8bd5631681900b92db8fdd14b1edfa67e5c7a21d842b31bdd56b503a03b039e11c4bede60389e6608286506cd91f5bb2db5886cfa0a73f98c3b5c7255678e6ac"} 18:07:38 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:07:38 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:07:38 INFO - Contents: 18:07:38 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9183a80006f1a98a44850d856eeaa261972567ed6db8a5fb5d3a7382d9dc9a81f6ed248466d4ceeaa52c92fe323eff3621c40b9ab1cb7aaa846eb6be75feb98a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8bd5631681900b92db8fdd14b1edfa67e5c7a21d842b31bdd56b503a03b039e11c4bede60389e6608286506cd91f5bb2db5886cfa0a73f98c3b5c7255678e6ac"} 18:07:38 INFO - Running post-run listener: copy_logs_to_upload_dir 18:07:38 INFO - Copying logs to upload dir... 18:07:38 INFO - mkdir: /builds/slave/test/build/upload/logs 18:07:38 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1265.166428 ========= master_lag: 5.22 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 10 secs) (at 2016-03-10 18:07:43.247763) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 3 secs) (at 2016-03-10 18:07:43.254944) ========= 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.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9183a80006f1a98a44850d856eeaa261972567ed6db8a5fb5d3a7382d9dc9a81f6ed248466d4ceeaa52c92fe323eff3621c40b9ab1cb7aaa846eb6be75feb98a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8bd5631681900b92db8fdd14b1edfa67e5c7a21d842b31bdd56b503a03b039e11c4bede60389e6608286506cd91f5bb2db5886cfa0a73f98c3b5c7255678e6ac"} build_url:https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011287 build_url: 'https://queue.taskcluster.net/v1/task/YbrJVh7lTYuSr3YXwroo1A/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9183a80006f1a98a44850d856eeaa261972567ed6db8a5fb5d3a7382d9dc9a81f6ed248466d4ceeaa52c92fe323eff3621c40b9ab1cb7aaa846eb6be75feb98a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8bd5631681900b92db8fdd14b1edfa67e5c7a21d842b31bdd56b503a03b039e11c4bede60389e6608286506cd91f5bb2db5886cfa0a73f98c3b5c7255678e6ac"}' ========= master_lag: 3.94 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 3 secs) (at 2016-03-10 18:07:47.202412) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 10 secs) (at 2016-03-10 18:07:47.202756) ========= 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.vZrn1llHMx/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.PRw7UMgwS0/Listeners TMPDIR=/var/folders/sw/56y5nypd5nvd19g5t_5x1crw00000w/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.005600 ========= master_lag: 10.94 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 10 secs) (at 2016-03-10 18:07:58.143640) ========= ========= Started reboot skipped (results: 3, elapsed: 1 secs) (at 2016-03-10 18:07:58.143914) ========= ========= Finished reboot skipped (results: 3, elapsed: 1 secs) (at 2016-03-10 18:07:59.348591) ========= ========= Total master_lag: 21.53 =========