builder: fx-team_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0050 starttime: 1447890700.46 results: success (0) buildid: 20151118132640 builduid: 3db70a23c2394cb0af97832db866f87c revision: e8c43ec095e309c1b11fb62be41cf3bd22f30e01 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:40.459469) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:40.459956) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:40.464371) ========= 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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners TMPDIR=/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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.005341 basedir: '/builds/slave/test' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:40.499906) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:40.500262) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:40.520655) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 6 secs) (at 2015-11-18 15:51:40.521084) ========= 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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners TMPDIR=/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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.005719 ========= master_lag: 6.48 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 6 secs) (at 2015-11-18 15:51:47.003374) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:47.003744) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:47.004116) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:47.008478) ========= 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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners TMPDIR=/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 --2015-11-18 15:51:47-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 8.09M=0.001s 2015-11-18 15:51:47 (8.09 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.209667 ========= master_lag: 0.13 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:47.349137) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:47.349477) ========= 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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners TMPDIR=/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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.025643 ========= master_lag: 0.08 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:47.450445) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:47.450799) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev e8c43ec095e309c1b11fb62be41cf3bd22f30e01 --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 e8c43ec095e309c1b11fb62be41cf3bd22f30e01 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.F3nnS6kF7g/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.HbbZpTd0zY/Listeners TMPDIR=/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 2015-11-18 15:51:47,533 truncating revision to first 12 chars 2015-11-18 15:51:47,533 Setting DEBUG logging. 2015-11-18 15:51:47,534 attempt 1/10 2015-11-18 15:51:47,534 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/e8c43ec095e3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-18 15:51:48,223 unpacking tar archive at: fx-team-e8c43ec095e3/testing/mozharness/ program finished with exit code 0 elapsedTime=0.924577 ========= master_lag: 0.07 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:48.445038) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:48.448486) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:48.462733) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:48.463081) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-18 15:51:48.463515) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 18 secs) (at 2015-11-18 15:51:48.463822) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--system-bits', '64', '--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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners TMPDIR=/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 15:51:48 INFO - MultiFileLogger online at 20151118 15:51:48 in /builds/slave/test 15:51:48 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 15:51:48 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:51:48 INFO - {'append_to_log': False, 15:51:48 INFO - 'base_work_dir': '/builds/slave/test', 15:51:48 INFO - 'blob_upload_branch': 'Fx-Team', 15:51:48 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:51:48 INFO - 'branch': 'Fx-Team', 15:51:48 INFO - 'buildbot_json_path': 'buildprops.json', 15:51:48 INFO - 'config_files': ('talos/mac_config.py',), 15:51:48 INFO - 'default_actions': ('clobber', 15:51:48 INFO - 'read-buildbot-config', 15:51:48 INFO - 'download-and-extract', 15:51:48 INFO - 'populate-webroot', 15:51:48 INFO - 'create-virtualenv', 15:51:48 INFO - 'install', 15:51:48 INFO - 'run-tests'), 15:51:48 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:51:48 INFO - 'download_minidump_stackwalk': True, 15:51:48 INFO - 'download_symbols': 'ondemand', 15:51:48 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:51:48 INFO - 'tooltool.py': '/tools/tooltool.py', 15:51:48 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:51:48 INFO - '/tools/misc-python/virtualenv.py')}, 15:51:48 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:51:48 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:51:48 INFO - 'installer_path': 'installer.exe', 15:51:48 INFO - 'log_level': 'info', 15:51:48 INFO - 'log_name': 'talos', 15:51:48 INFO - 'log_to_console': True, 15:51:48 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 15:51:48 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 15:51:48 INFO - 'opt_config_files': (), 15:51:48 INFO - 'pip_index': False, 15:51:48 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:51:48 INFO - 'cmd': ('bash', 15:51:48 INFO - '-c', 15:51:48 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:51:48 INFO - 'enabled': True, 15:51:48 INFO - 'halt_on_failure': False, 15:51:48 INFO - 'name': 'check_screen_resolution'},), 15:51:48 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:51:48 INFO - 'cmd': ('bash', 15:51:48 INFO - '-c', 15:51:48 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:51:48 INFO - 'enabled': True, 15:51:48 INFO - 'halt_on_failure': False, 15:51:48 INFO - 'name': 'check_screen_resolution'},), 15:51:48 INFO - 'run_cmd_checks_enabled': True, 15:51:48 INFO - 'sps_profile': False, 15:51:48 INFO - 'sps_profile_interval': 0, 15:51:48 INFO - 'suite': 'dromaeojs-e10s', 15:51:48 INFO - 'system_bits': '64', 15:51:48 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:51:48 INFO - 'title': 't-yosemite-r7-0050', 15:51:48 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:51:48 INFO - 'use_talos_json': True, 15:51:48 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:51:48 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:51:48 INFO - 'work_dir': 'build'} 15:51:48 INFO - ##### 15:51:48 INFO - ##### Running clobber step. 15:51:48 INFO - ##### 15:51:48 INFO - Running pre-action listener: _resource_record_pre_action 15:51:48 INFO - Running main action method: clobber 15:51:48 INFO - rmtree: /builds/slave/test/build 15:51:48 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:51:50 INFO - Running post-action listener: _resource_record_post_action 15:51:50 INFO - ##### 15:51:50 INFO - ##### Running read-buildbot-config step. 15:51:50 INFO - ##### 15:51:50 INFO - Running pre-action listener: _resource_record_pre_action 15:51:50 INFO - Running main action method: read_buildbot_config 15:51:50 INFO - Using buildbot properties: 15:51:50 INFO - { 15:51:50 INFO - "properties": { 15:51:50 INFO - "buildnumber": 4, 15:51:50 INFO - "product": "firefox", 15:51:50 INFO - "script_repo_revision": "production", 15:51:50 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs-e10s", 15:51:50 INFO - "repository": "", 15:51:50 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs-e10s", 15:51:50 INFO - "buildid": "20151118132640", 15:51:50 INFO - "slavename": "t-yosemite-r7-0050", 15:51:50 INFO - "pgo_build": "False", 15:51:50 INFO - "basedir": "/builds/slave/test", 15:51:50 INFO - "project": "", 15:51:50 INFO - "platform": "yosemite_r7", 15:51:50 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 15:51:50 INFO - "slavebuilddir": "test", 15:51:50 INFO - "scheduler": "tests-fx-team-macosx64-talos", 15:51:50 INFO - "branch": "fx-team", 15:51:50 INFO - "repo_path": "integration/fx-team", 15:51:50 INFO - "stage_platform": "macosx64", 15:51:50 INFO - "builduid": "3db70a23c2394cb0af97832db866f87c", 15:51:50 INFO - "revision": "e8c43ec095e309c1b11fb62be41cf3bd22f30e01" 15:51:50 INFO - }, 15:51:50 INFO - "sourcestamp": { 15:51:50 INFO - "repository": "", 15:51:50 INFO - "hasPatch": false, 15:51:50 INFO - "project": "", 15:51:50 INFO - "branch": "fx-team-macosx64-talos", 15:51:50 INFO - "changes": [ 15:51:50 INFO - { 15:51:50 INFO - "category": null, 15:51:50 INFO - "files": [ 15:51:50 INFO - { 15:51:50 INFO - "url": null, 15:51:50 INFO - "name": "https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 15:51:50 INFO - } 15:51:50 INFO - ], 15:51:50 INFO - "repository": "", 15:51:50 INFO - "rev": "e8c43ec095e309c1b11fb62be41cf3bd22f30e01", 15:51:50 INFO - "who": "jlong@mozilla.com", 15:51:50 INFO - "when": 1447887116, 15:51:50 INFO - "number": 6679160, 15:51:50 INFO - "comments": "Bug 1132501 - attach a debugging thread automatically when the toolbox opens r=jryans", 15:51:50 INFO - "project": "", 15:51:50 INFO - "at": "Wed 18 Nov 2015 14:51:56", 15:51:50 INFO - "branch": "fx-team-macosx64-talos", 15:51:50 INFO - "revlink": "", 15:51:50 INFO - "properties": [ 15:51:50 INFO - [ 15:51:50 INFO - "buildid", 15:51:50 INFO - "20151118132640", 15:51:50 INFO - "Change" 15:51:50 INFO - ], 15:51:50 INFO - [ 15:51:50 INFO - "builduid", 15:51:50 INFO - "3db70a23c2394cb0af97832db866f87c", 15:51:50 INFO - "Change" 15:51:50 INFO - ], 15:51:50 INFO - [ 15:51:50 INFO - "pgo_build", 15:51:50 INFO - "False", 15:51:50 INFO - "Change" 15:51:50 INFO - ] 15:51:50 INFO - ], 15:51:50 INFO - "revision": "e8c43ec095e309c1b11fb62be41cf3bd22f30e01" 15:51:50 INFO - } 15:51:50 INFO - ], 15:51:50 INFO - "revision": "e8c43ec095e309c1b11fb62be41cf3bd22f30e01" 15:51:50 INFO - } 15:51:50 INFO - } 15:51:50 INFO - Found installer url https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 15:51:50 INFO - Running post-action listener: _resource_record_post_action 15:51:50 INFO - ##### 15:51:50 INFO - ##### Running download-and-extract step. 15:51:50 INFO - ##### 15:51:50 INFO - Running pre-action listener: _resource_record_pre_action 15:51:50 INFO - Running main action method: download_and_extract 15:51:50 INFO - mkdir: /builds/slave/test/build/tests 15:51:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:50 INFO - https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 15:51:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/test_packages.json 15:51:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/test_packages.json 15:51:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 15:51:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 15:51:51 INFO - Downloaded 1149 bytes. 15:51:51 INFO - Reading from file /builds/slave/test/build/test_packages.json 15:51:51 INFO - Using the following test package requirements: 15:51:51 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:51:51 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:51:51 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 15:51:51 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:51:51 INFO - u'jsshell-mac.zip'], 15:51:51 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:51:51 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 15:51:51 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:51:51 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:51:51 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 15:51:51 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:51:51 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 15:51:51 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:51:51 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 15:51:51 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:51:51 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:51:51 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 15:51:51 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 15:51:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:51 INFO - https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 15:51:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:51:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:51:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:51:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 15:51:52 INFO - Downloaded 17477356 bytes. 15:51:52 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 15:51:52 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:51:52 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 15:51:55 INFO - Return code: 0 15:51:55 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 15:51:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:51:55 INFO - https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 15:51:55 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:51:55 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:51:55 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:51:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 15:51:56 INFO - Downloaded 17477356 bytes. 15:51:56 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 15:51:56 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:51:56 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 15:51:59 INFO - Return code: 0 15:51:59 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')]} 15:51:59 INFO - https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 15:51:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:51:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:51:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:51:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 15:52:00 INFO - Downloaded 11130997 bytes. 15:52:00 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 15:52:00 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:52:00 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 15:52:00 INFO - Return code: 0 15:52:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:52:00 INFO - https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 15:52:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:52:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:52:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 15:52:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 15:52:03 INFO - Downloaded 108851636 bytes. 15:52:03 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:52:03 INFO - mkdir: /builds/slave/test/properties 15:52:03 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:52:03 INFO - Writing to file /builds/slave/test/properties/build_url 15:52:03 INFO - Contents: 15:52:03 INFO - build_url:https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:52:03 INFO - Running post-action listener: _resource_record_post_action 15:52:03 INFO - Running post-action listener: set_extra_try_arguments 15:52:03 INFO - ##### 15:52:03 INFO - ##### Running populate-webroot step. 15:52:03 INFO - ##### 15:52:03 INFO - Running pre-action listener: _resource_record_pre_action 15:52:03 INFO - Running main action method: populate_webroot 15:52:03 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:52:03 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:52:03 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 15:52:03 INFO - '../fennec_ids.txt'], 15:52:03 INFO - 'tests': ['tcheck2']}, 15:52:03 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:52:03 INFO - '--tppagecycles', 15:52:03 INFO - '7'], 15:52:03 INFO - 'tests': ['tsvgm']}}, 15:52:03 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 15:52:03 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:52:03 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:52:03 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:52:03 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:52:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:52:03 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:52:03 INFO - 'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:52:03 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:52:03 INFO - 'tests': ['damp', 'tps']}, 15:52:03 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:52:03 INFO - 'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['damp', 'tps']}, 15:52:03 INFO - 'g3': {'tests': ['dromaeo_dom']}, 15:52:03 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:52:03 INFO - 'other': {'tests': ['a11yr', 15:52:03 INFO - 'ts_paint', 15:52:03 INFO - 'tpaint', 15:52:03 INFO - 'sessionrestore', 15:52:03 INFO - 'sessionrestore_no_auto_restore']}, 15:52:03 INFO - 'other-e10s': {'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['a11yr', 15:52:03 INFO - 'ts_paint', 15:52:03 INFO - 'tpaint', 15:52:03 INFO - 'sessionrestore', 15:52:03 INFO - 'sessionrestore_no_auto_restore']}, 15:52:03 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['a11yr', 15:52:03 INFO - 'ts_paint', 15:52:03 INFO - 'tpaint', 15:52:03 INFO - 'sessionrestore', 15:52:03 INFO - 'sessionrestore_no_auto_restore']}, 15:52:03 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['a11yr', 15:52:03 INFO - 'ts_paint', 15:52:03 INFO - 'tpaint', 15:52:03 INFO - 'sessionrestore', 15:52:03 INFO - 'sessionrestore_no_auto_restore']}, 15:52:03 INFO - 'other_l64': {'tests': ['a11yr', 15:52:03 INFO - 'ts_paint', 15:52:03 INFO - 'tpaint', 15:52:03 INFO - 'sessionrestore', 15:52:03 INFO - 'sessionrestore_no_auto_restore']}, 15:52:03 INFO - 'other_nol64': {'tests': ['a11yr', 15:52:03 INFO - 'ts_paint', 15:52:03 INFO - 'tpaint', 15:52:03 INFO - 'sessionrestore', 15:52:03 INFO - 'sessionrestore_no_auto_restore']}, 15:52:03 INFO - 'svgr': {'tests': ['tsvgx', 15:52:03 INFO - 'tsvgr_opacity', 15:52:03 INFO - 'tart', 15:52:03 INFO - 'tscrollx', 15:52:03 INFO - 'cart']}, 15:52:03 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['tsvgx', 15:52:03 INFO - 'tsvgr_opacity', 15:52:03 INFO - 'tart', 15:52:03 INFO - 'tscrollx', 15:52:03 INFO - 'cart']}, 15:52:03 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:52:03 INFO - 'tests': ['tp5o']}, 15:52:03 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:52:03 INFO - 'talos_options': ['--e10s'], 15:52:03 INFO - 'tests': ['tp5o']}, 15:52:03 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:52:03 INFO - 'talos_options': ['--xperf_path', 15:52:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:52:03 INFO - 'tests': ['tp5n']}, 15:52:03 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:52:03 INFO - 'talos_options': ['--e10s', 15:52:03 INFO - '--xperf_path', 15:52:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:52:03 INFO - 'tests': ['tp5n']}}, 15:52:03 INFO - 'talos.zip': {'path': '', 15:52:03 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:52:03 INFO - Running post-action listener: _resource_record_post_action 15:52:03 INFO - ##### 15:52:03 INFO - ##### Running create-virtualenv step. 15:52:03 INFO - ##### 15:52:03 INFO - Running pre-action listener: _resource_record_pre_action 15:52:03 INFO - Running main action method: create_virtualenv 15:52:03 INFO - Creating virtualenv /builds/slave/test/build/venv 15:52:03 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 15:52:03 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:52:03 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:52:03 INFO - Using real prefix '/tools/python27' 15:52:03 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:52:04 INFO - Installing distribute.............................................................................................................................................................................................done. 15:52:07 INFO - Installing pip.................done. 15:52:07 INFO - Return code: 0 15:52:07 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:52:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:52:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:52:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:52:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:52:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x10d19c490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d179228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feeb1d4fa20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d0c09f0>, '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 0x10ce1fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d0b38c8>, '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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 15:52:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:52:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:52:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.F3nnS6kF7g/Render', 15:52:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:52:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:52:07 INFO - 'HOME': '/Users/cltbld', 15:52:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:52:07 INFO - 'LOGNAME': 'cltbld', 15:52:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:52:07 INFO - 'MOZ_NO_REMOTE': '1', 15:52:07 INFO - 'NO_EM_RESTART': '1', 15:52:07 INFO - 'PAGER': '/bin/cat', 15:52:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:52:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:52:07 INFO - 'PWD': '/builds/slave/test', 15:52:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:52:07 INFO - 'SHELL': '/bin/bash', 15:52:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HbbZpTd0zY/Listeners', 15:52:07 INFO - 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/', 15:52:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:52:07 INFO - 'USER': 'cltbld', 15:52:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:52:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:52:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:52:07 INFO - 'XPC_FLAGS': '0x0', 15:52:07 INFO - 'XPC_SERVICE_NAME': '0', 15:52:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:52:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:52:07 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 15:52:07 INFO - Cleaning up... 15:52:07 INFO - Return code: 0 15:52:07 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 15:52:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:52:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:52:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:52:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:52:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x10d19c490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d179228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feeb1d4fa20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d0c09f0>, '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 0x10ce1fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d0b38c8>, '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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 15:52:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:52:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:52:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.F3nnS6kF7g/Render', 15:52:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:52:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:52:07 INFO - 'HOME': '/Users/cltbld', 15:52:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:52:07 INFO - 'LOGNAME': 'cltbld', 15:52:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:52:07 INFO - 'MOZ_NO_REMOTE': '1', 15:52:07 INFO - 'NO_EM_RESTART': '1', 15:52:07 INFO - 'PAGER': '/bin/cat', 15:52:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:52:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:52:07 INFO - 'PWD': '/builds/slave/test', 15:52:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:52:07 INFO - 'SHELL': '/bin/bash', 15:52:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HbbZpTd0zY/Listeners', 15:52:07 INFO - 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/', 15:52:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:52:07 INFO - 'USER': 'cltbld', 15:52:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:52:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:52:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:52:07 INFO - 'XPC_FLAGS': '0x0', 15:52:07 INFO - 'XPC_SERVICE_NAME': '0', 15:52:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:52:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:52:07 INFO - Downloading/unpacking psutil>=0.7.1 15:52: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 15:52: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 15:52: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 15:52: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 15:52: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 15:52: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 15:52:10 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 15:52:10 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 15:52:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:52:10 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:52:10 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:52:10 INFO - Installing collected packages: psutil 15:52:10 INFO - Running setup.py install for psutil 15:52:10 INFO - building 'psutil._psutil_osx' extension 15:52:10 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 15:52:11 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 15:52:11 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 15:52:11 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 15:52:11 INFO - building 'psutil._psutil_posix' extension 15:52:11 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 15:52:11 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 15:52:11 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 15:52:11 INFO - ^ 15:52:11 INFO - 1 warning generated. 15:52:11 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 15:52:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:52:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:52:11 INFO - Successfully installed psutil 15:52:11 INFO - Cleaning up... 15:52:11 INFO - Return code: 0 15:52:11 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 15:52:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:52:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:52:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:52:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:52:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x10d19c490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d179228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feeb1d4fa20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d0c09f0>, '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 0x10ce1fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d0b38c8>, '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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 15:52:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:52:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:52:11 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.F3nnS6kF7g/Render', 15:52:11 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:52:11 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:52:11 INFO - 'HOME': '/Users/cltbld', 15:52:11 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:52:11 INFO - 'LOGNAME': 'cltbld', 15:52:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:52:11 INFO - 'MOZ_NO_REMOTE': '1', 15:52:11 INFO - 'NO_EM_RESTART': '1', 15:52:11 INFO - 'PAGER': '/bin/cat', 15:52:11 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:52:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:52:11 INFO - 'PWD': '/builds/slave/test', 15:52:11 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:52:11 INFO - 'SHELL': '/bin/bash', 15:52:11 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HbbZpTd0zY/Listeners', 15:52:11 INFO - 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/', 15:52:11 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:52:11 INFO - 'USER': 'cltbld', 15:52:11 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:52:11 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:52:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:52:11 INFO - 'XPC_FLAGS': '0x0', 15:52:11 INFO - 'XPC_SERVICE_NAME': '0', 15:52:11 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:52:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:52:11 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 15:52:11 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 15:52:11 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 15:52:11 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 15:52:11 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 15:52:11 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 15:52:11 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 15:52:14 INFO - Downloading mozsystemmonitor-0.0.tar.gz 15:52:14 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 15:52:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:52:14 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 15:52:14 INFO - Installing collected packages: mozsystemmonitor 15:52:14 INFO - Running setup.py install for mozsystemmonitor 15:52:14 INFO - Successfully installed mozsystemmonitor 15:52:14 INFO - Cleaning up... 15:52:14 INFO - Return code: 0 15:52:14 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:52: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')]} 15:52:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:52:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52: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')]} 15:52:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:52:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x10d19c490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d179228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feeb1d4fa20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d0c09f0>, '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 0x10ce1fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d0b38c8>, '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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 15:52:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:52:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:52:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.F3nnS6kF7g/Render', 15:52:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:52:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:52:14 INFO - 'HOME': '/Users/cltbld', 15:52:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:52:14 INFO - 'LOGNAME': 'cltbld', 15:52:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:52:14 INFO - 'MOZ_NO_REMOTE': '1', 15:52:14 INFO - 'NO_EM_RESTART': '1', 15:52:14 INFO - 'PAGER': '/bin/cat', 15:52:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:52:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:52:14 INFO - 'PWD': '/builds/slave/test', 15:52:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:52:14 INFO - 'SHELL': '/bin/bash', 15:52:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HbbZpTd0zY/Listeners', 15:52:14 INFO - 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/', 15:52:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:52:14 INFO - 'USER': 'cltbld', 15:52:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:52:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:52:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:52:14 INFO - 'XPC_FLAGS': '0x0', 15:52:14 INFO - 'XPC_SERVICE_NAME': '0', 15:52:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:52:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:52:14 INFO - Downloading/unpacking blobuploader==1.2.4 15:52:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:52:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:52:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:52:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:52:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:52:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:52:16 INFO - Downloading blobuploader-1.2.4.tar.gz 15:52:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 15:52:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:52:16 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:52: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 15:52: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 15:52: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 15:52: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 15:52: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 15:52: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 15:52:17 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 15:52:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:52:17 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:52:17 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 15:52:17 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 15:52:17 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 15:52:17 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 15:52:17 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 15:52:17 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 15:52:17 INFO - Downloading docopt-0.6.1.tar.gz 15:52:17 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 15:52:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:52:17 INFO - Installing collected packages: blobuploader, requests, docopt 15:52:17 INFO - Running setup.py install for blobuploader 15:52:18 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:52:18 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:52:18 INFO - Running setup.py install for requests 15:52:18 INFO - Running setup.py install for docopt 15:52:18 INFO - Successfully installed blobuploader requests docopt 15:52:18 INFO - Cleaning up... 15:52:18 INFO - Return code: 0 15:52:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:52:18 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')]} 15:52:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:52:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:18 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')]} 15:52:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:52:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x10d19c490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d179228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feeb1d4fa20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d0c09f0>, '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 0x10ce1fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d0b38c8>, '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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 15:52:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:52:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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 15:52:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.F3nnS6kF7g/Render', 15:52:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:52:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:52:18 INFO - 'HOME': '/Users/cltbld', 15:52:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:52:18 INFO - 'LOGNAME': 'cltbld', 15:52:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:52:18 INFO - 'MOZ_NO_REMOTE': '1', 15:52:18 INFO - 'NO_EM_RESTART': '1', 15:52:18 INFO - 'PAGER': '/bin/cat', 15:52:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:52:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:52:18 INFO - 'PWD': '/builds/slave/test', 15:52:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:52:18 INFO - 'SHELL': '/bin/bash', 15:52:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HbbZpTd0zY/Listeners', 15:52:18 INFO - 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/', 15:52:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:52:18 INFO - 'USER': 'cltbld', 15:52:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:52:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:52:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:52:18 INFO - 'XPC_FLAGS': '0x0', 15:52:18 INFO - 'XPC_SERVICE_NAME': '0', 15:52:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:52:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-t9bp6b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-m9Rzfb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-kUXd3S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-STYG5K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-hs37TK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-_3Yor4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-37a7km-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-lvDc58-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-EZj0XM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:52:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:52:19 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-QnUsQf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:52:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:52:20 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-nSGr5A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:52:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:52:20 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-7CGazQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:52:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:52:20 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-j3NfSA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:52:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:52:20 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-AqxH2v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:52:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:52:20 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-sr7j0Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:52:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:52:20 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-tWaN9C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:52:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:52:20 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-8ommKx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:52:20 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:52:20 INFO - Running setup.py install for manifestparser 15:52:20 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:52:20 INFO - Running setup.py install for mozcrash 15:52:21 INFO - Running setup.py install for mozdebug 15:52:21 INFO - Running setup.py install for mozdevice 15:52:21 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:52:21 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:52:21 INFO - Running setup.py install for mozfile 15:52:21 INFO - Running setup.py install for mozhttpd 15:52:21 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:52:21 INFO - Running setup.py install for mozinfo 15:52:21 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:52:21 INFO - Running setup.py install for mozInstall 15:52:21 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:52:21 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:52:21 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:52:21 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:52:21 INFO - Running setup.py install for mozleak 15:52:22 INFO - Running setup.py install for mozlog 15:52:22 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:52:22 INFO - Running setup.py install for moznetwork 15:52:22 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:52:22 INFO - Running setup.py install for mozprocess 15:52:22 INFO - Running setup.py install for mozprofile 15:52:22 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:52:22 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:52:22 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:52:22 INFO - Running setup.py install for mozrunner 15:52:22 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:52:22 INFO - Running setup.py install for mozscreenshot 15:52:23 INFO - Running setup.py install for moztest 15:52:23 INFO - Running setup.py install for mozversion 15:52:23 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:52:23 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:52:23 INFO - Cleaning up... 15:52:23 INFO - Return code: 0 15:52:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:52:23 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')]} 15:52:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:52:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:23 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')]} 15:52:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:52:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x10d19c490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d179228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feeb1d4fa20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d0c09f0>, '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 0x10ce1fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d0b38c8>, '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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 15:52:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:52:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:52:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.F3nnS6kF7g/Render', 15:52:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:52:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:52:23 INFO - 'HOME': '/Users/cltbld', 15:52:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:52:23 INFO - 'LOGNAME': 'cltbld', 15:52:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:52:23 INFO - 'MOZ_NO_REMOTE': '1', 15:52:23 INFO - 'NO_EM_RESTART': '1', 15:52:23 INFO - 'PAGER': '/bin/cat', 15:52:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:52:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:52:23 INFO - 'PWD': '/builds/slave/test', 15:52:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:52:23 INFO - 'SHELL': '/bin/bash', 15:52:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HbbZpTd0zY/Listeners', 15:52:23 INFO - 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/', 15:52:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:52:23 INFO - 'USER': 'cltbld', 15:52:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:52:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:52:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:52:23 INFO - 'XPC_FLAGS': '0x0', 15:52:23 INFO - 'XPC_SERVICE_NAME': '0', 15:52:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:52:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:52:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:52:23 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-BH08D9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:52:23 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)) 15:52:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:52:23 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-I8LDNJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:52:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:52:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:52:23 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-Ccm_so-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:52:23 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)) 15:52:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:52:23 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-7i2quC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:52:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-eQvob_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:52:24 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-lKoQ7T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:52:24 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-1_gAaB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:52:24 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-4JSwLC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:52:24 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-4baGKt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:52:24 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-jaQ8UY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:52:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-Zs8Vv_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:52:24 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-q2JEEn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:52:24 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)) 15:52:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:52:24 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-ctEp_L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:52:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 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)) 15:52:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:52:25 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-YjoQ8t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:52:25 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)) 15:52:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:52:25 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-bpsdhs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:52:25 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)) 15:52:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:52:25 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-sKgywc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:52:25 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)) 15:52:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:52:25 INFO - Running setup.py (path:/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/pip-HcF0xQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:52:25 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)) 15:52:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:52:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:52:25 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)) 15:52:25 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:52:25 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:52:25 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:52: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 15:52: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 15:52: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 15:52: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 15:52: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 15:52: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 15:52:27 INFO - Downloading blessings-1.5.1.tar.gz 15:52:27 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 15:52:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:52:27 INFO - Installing collected packages: blessings 15:52:27 INFO - Running setup.py install for blessings 15:52:27 INFO - Successfully installed blessings 15:52:27 INFO - Cleaning up... 15:52:27 INFO - Return code: 0 15:52:27 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:52:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:52:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:52:28 INFO - Reading from file tmpfile_stdout 15:52:28 INFO - Current package versions: 15:52:28 INFO - blessings == 1.5.1 15:52:28 INFO - blobuploader == 1.2.4 15:52:28 INFO - docopt == 0.6.1 15:52:28 INFO - manifestparser == 1.1 15:52:28 INFO - mozInstall == 1.12 15:52:28 INFO - mozcrash == 0.16 15:52:28 INFO - mozdebug == 0.1 15:52:28 INFO - mozdevice == 0.47 15:52:28 INFO - mozfile == 1.2 15:52:28 INFO - mozhttpd == 0.7 15:52:28 INFO - mozinfo == 0.9 15:52:28 INFO - mozleak == 0.1 15:52:28 INFO - mozlog == 3.0 15:52:28 INFO - moznetwork == 0.27 15:52:28 INFO - mozprocess == 0.22 15:52:28 INFO - mozprofile == 0.27 15:52:28 INFO - mozrunner == 6.11 15:52:28 INFO - mozscreenshot == 0.1 15:52:28 INFO - mozsystemmonitor == 0.0 15:52:28 INFO - moztest == 0.7 15:52:28 INFO - mozversion == 1.4 15:52:28 INFO - psutil == 3.1.1 15:52:28 INFO - requests == 1.2.3 15:52:28 INFO - wsgiref == 0.1.2 15:52:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:52:28 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')]} 15:52:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:52:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:28 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')]} 15:52:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:52:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:52:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x10d19c490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d179228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feeb1d4fa20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d0c09f0>, '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 0x10ce1fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d0b38c8>, '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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 15:52:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:52:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:52:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.F3nnS6kF7g/Render', 15:52:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:52:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:52:28 INFO - 'HOME': '/Users/cltbld', 15:52:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:52:28 INFO - 'LOGNAME': 'cltbld', 15:52:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:52:28 INFO - 'MOZ_NO_REMOTE': '1', 15:52:28 INFO - 'NO_EM_RESTART': '1', 15:52:28 INFO - 'PAGER': '/bin/cat', 15:52:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:52:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:52:28 INFO - 'PWD': '/builds/slave/test', 15:52:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:52:28 INFO - 'SHELL': '/bin/bash', 15:52:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HbbZpTd0zY/Listeners', 15:52:28 INFO - 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/', 15:52:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:52:28 INFO - 'USER': 'cltbld', 15:52:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:52:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:52:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:52:28 INFO - 'XPC_FLAGS': '0x0', 15:52:28 INFO - 'XPC_SERVICE_NAME': '0', 15:52:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:52:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:52:28 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 1)) 15:52:28 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 2)) 15:52:28 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 3)) 15:52:28 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 4)) 15:52:28 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 5)) 15:52:28 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 6)) 15:52:28 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 7)) 15:52:28 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 8)) 15:52:28 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.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:52:28 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 3)) 15:52:28 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.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:52:28 INFO - Cleaning up... 15:52:28 INFO - Return code: 0 15:52:28 INFO - Running post-action listener: _resource_record_post_action 15:52:28 INFO - Running post-action listener: _start_resource_monitoring 15:52:28 INFO - Starting resource monitoring. 15:52:28 INFO - ##### 15:52:28 INFO - ##### Running install step. 15:52:28 INFO - ##### 15:52:28 INFO - Running pre-action listener: _resource_record_pre_action 15:52:28 INFO - Running main action method: install 15:52:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:52:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:52:29 INFO - Reading from file tmpfile_stdout 15:52:29 INFO - Detecting whether we're running mozinstall >=1.0... 15:52:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:52:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:52:29 INFO - Reading from file tmpfile_stdout 15:52:29 INFO - Output received: 15:52:29 INFO - Usage: mozinstall [options] installer 15:52:29 INFO - Options: 15:52:29 INFO - -h, --help show this help message and exit 15:52:29 INFO - -d DEST, --destination=DEST 15:52:29 INFO - Directory to install application into. [default: 15:52:29 INFO - "/builds/slave/test"] 15:52:29 INFO - --app=APP Application being installed. [default: firefox] 15:52:29 INFO - mkdir: /builds/slave/test/build/application 15:52:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 15:52:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 15:52:59 INFO - Reading from file tmpfile_stdout 15:52:59 INFO - Output received: 15:52:59 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 15:52:59 INFO - Running post-action listener: _resource_record_post_action 15:52:59 INFO - ##### 15:52:59 INFO - ##### Running run-tests step. 15:52:59 INFO - ##### 15:52:59 INFO - Running pre-action listener: _resource_record_pre_action 15:52:59 INFO - Running main action method: run_tests 15:52:59 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 15:52:59 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 15:52:59 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 15:52:59 INFO - 2015-11-18 15:52:59.900 screenresolution[1644:7359] starting screenresolution argv=screenresolution get 15:52:59 INFO - 2015-11-18 15:52:59.903 screenresolution[1644:7359] Display 0: 1600x1200x32@60 15:52:59 INFO - 2015-11-18 15:52:59.909 screenresolution[1645:7362] starting screenresolution argv=screenresolution list 15:52:59 INFO - Available Modes on Display 0 15:52:59 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 15:52:59 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 15:52:59 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 15:52:59 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 15:53:00 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 15:53:00 INFO - Intel Iris: 15:53:00 INFO - Chipset Model: Intel Iris 15:53:00 INFO - Type: GPU 15:53:00 INFO - Bus: Built-In 15:53:00 INFO - VRAM (Dynamic, Max): 1536 MB 15:53:00 INFO - Vendor: Intel (0x8086) 15:53:00 INFO - Device ID: 0x0a2e 15:53:00 INFO - Revision ID: 0x0009 15:53:00 INFO - Displays: 15:53:00 INFO - Display: 15:53:00 INFO - Resolution: 1600 x 1200 @ 60 Hz 15:53:00 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 15:53:00 INFO - Display Serial Number: 1600x1200 60 15:53:00 INFO - Main Display: Yes 15:53:00 INFO - Mirror: Off 15:53:00 INFO - Online: Yes 15:53:00 INFO - Rotation: Supported 15:53:00 INFO - Return code: 0 15:53:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:53:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:53:00 INFO - Python 2.7.3 15:53:00 INFO - Return code: 0 15:53:00 INFO - grabbing minidump binary from tooltool 15:53:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:53:00 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 0x10d0c09f0>, '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 0x10ce1fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d0b38c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:53:00 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 15:53:00 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 15:53:00 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:53:00 INFO - Return code: 0 15:53:00 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 15:53:00 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:53:00 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:53:00 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 15:53:00 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:53:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0050', '--webServer', 'localhost'] in /builds/slave/test/build 15:53:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0050 --webServer localhost 15:53:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.F3nnS6kF7g/Render', 15:53:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:53:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:53:00 INFO - 'HOME': '/Users/cltbld', 15:53:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:53:00 INFO - 'LOGNAME': 'cltbld', 15:53:00 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:53:00 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 15:53:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:00 INFO - 'MOZ_NO_REMOTE': '1', 15:53:00 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:53:00 INFO - 'NO_EM_RESTART': '1', 15:53:00 INFO - 'PAGER': '/bin/cat', 15:53:00 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:53:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:00 INFO - 'PWD': '/builds/slave/test', 15:53:00 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:53:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:53:00 INFO - 'SHELL': '/bin/bash', 15:53:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HbbZpTd0zY/Listeners', 15:53:00 INFO - 'TMPDIR': '/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/', 15:53:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:53:00 INFO - 'USER': 'cltbld', 15:53:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:53:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:53:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:00 INFO - 'XPC_FLAGS': '0x0', 15:53:00 INFO - 'XPC_SERVICE_NAME': '0', 15:53:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:53:00 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0050', '--webServer', 'localhost'] with output_timeout 3600 15:53:00 INFO - mozversion INFO | application_buildid: 20151118132640 15:53:00 INFO - mozversion INFO | application_changeset: e8c43ec095e309c1b11fb62be41cf3bd22f30e01 15:53:00 INFO - mozversion INFO | application_display_name: Nightly 15:53:00 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:53:00 INFO - mozversion INFO | application_name: Firefox 15:53:00 INFO - mozversion INFO | application_remotingname: firefox 15:53:00 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 15:53:00 INFO - mozversion INFO | application_vendor: Mozilla 15:53:00 INFO - mozversion INFO | application_version: 45.0a1 15:53:00 INFO - mozversion INFO | platform_buildid: 20151118132640 15:53:00 INFO - mozversion INFO | platform_changeset: e8c43ec095e309c1b11fb62be41cf3bd22f30e01 15:53:00 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 15:53:00 INFO - mozversion INFO | platform_version: 45.0a1 15:53:00 INFO - 2015-11-18 15:53:00,455 DEBUG : using testdate: 1447890780 15:53:00 INFO - 2015-11-18 15:53:00,455 DEBUG : actual date: 1447890780 15:53:00 INFO - 2015-11-18 15:53:00,870 INFO : starting webserver on 'localhost:49264' 15:53:00 INFO - 2015-11-18 15:53:00,871 INFO : Starting test suite t-yosemite-r7-0050.e 15:53:00 INFO - 2015-11-18 15:53:00,871 INFO : Starting test dromaeo_css 15:53:00 INFO - 2015-11-18 15:53:00,871 DEBUG : operating with platform_type : mac_ 15:53:00 INFO - 2015-11-18 15:53:00,872 INFO : Initialising browser for dromaeo_css test... 15:53:00 INFO - 2015-11-18 15:53:00,886 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/tmpLptPKo/profile http://localhost:49264/getInfo.html 15:53:03 INFO - 2015-11-18 15:53:03,763 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 15:53:03 INFO - 2015-11-18 15:53:03,763 DEBUG : BROWSER_OUTPUT: colorDepth:24 15:53:03 INFO - 2015-11-18 15:53:03,764 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 15:53:03 INFO - 2015-11-18 15:53:03,764 DEBUG : BROWSER_OUTPUT: __metrics 15:53:04 INFO - 2015-11-18 15:53:04,364 INFO : Browser initialized. 15:53:04 INFO - 2015-11-18 15:53:04,364 INFO : Running cycle 1/1 for dromaeo_css test... 15:53:04 INFO - 2015-11-18 15:53:04,365 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/tmpLptPKo/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 15:53:16 INFO - 2015-11-18 15:53:16,224 DEBUG : BROWSER_OUTPUT: RSS: Main: 236826624 15:53:16 INFO - 2015-11-18 15:53:16,224 DEBUG : BROWSER_OUTPUT: 15:54:05 INFO - 2015-11-18 15:54:05,916 DEBUG : BROWSER_OUTPUT: 1447890845915 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] 15:56:15 INFO - 2015-11-18 15:56:15,836 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49264/tests/dromaeo/cssquery-ext.html) 15:56:17 INFO - 2015-11-18 15:56:17,229 DEBUG : BROWSER_OUTPUT: RSS: Main: 252530688 15:56:17 INFO - 2015-11-18 15:56:17,229 DEBUG : BROWSER_OUTPUT: 15:59:19 INFO - 2015-11-18 15:59:19,201 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/dromaeo/cssquery-ext.html (next: http://localhost:49264/tests/dromaeo/cssquery-jquery.html) 15:59:19 INFO - 2015-11-18 15:59:19,788 DEBUG : BROWSER_OUTPUT: RSS: Main: 262811648 15:59:19 INFO - 2015-11-18 15:59:19,788 DEBUG : BROWSER_OUTPUT: 16:02:21 INFO - 2015-11-18 16:02:21,394 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49264/tests/dromaeo/cssquery-mootools.html) 16:02:21 INFO - 2015-11-18 16:02:21,996 DEBUG : BROWSER_OUTPUT: RSS: Main: 262897664 16:02:21 INFO - 2015-11-18 16:02:21,997 DEBUG : BROWSER_OUTPUT: 16:05:23 INFO - 2015-11-18 16:05:23,577 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49264/tests/dromaeo/cssquery-prototype.html) 16:05:24 INFO - 2015-11-18 16:05:24,169 DEBUG : BROWSER_OUTPUT: RSS: Main: 266027008 16:05:24 INFO - 2015-11-18 16:05:24,170 DEBUG : BROWSER_OUTPUT: 16:08:26 INFO - 2015-11-18 16:08:26,692 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49264/tests/dromaeo/cssquery-yui.html) 16:08:27 INFO - 2015-11-18 16:08:27,304 DEBUG : BROWSER_OUTPUT: RSS: Main: 269783040 16:08:27 INFO - 2015-11-18 16:08:27,304 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,432 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/dromaeo/cssquery-yui.html (next: http://localhost:49264/tests/dromaeo/cssquery-dojo.html) 16:11:29 INFO - 2015-11-18 16:11:29,688 DEBUG : BROWSER_OUTPUT: RSS: Main: 271560704 16:11:29 INFO - 2015-11-18 16:11:29,688 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,688 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:11:29 INFO - 2015-11-18 16:11:29,688 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:11:29 INFO - 2015-11-18 16:11:29,688 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:11:29 INFO - 2015-11-18 16:11:29,688 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:11:29 INFO - 2015-11-18 16:11:29,689 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3340.8496617652213;3445.7587968842176;3502.264524449867;3546.1311978565254;3550.7159427245824;5810.854728631786;5852.736626851792;5854.443827836349;5854.795082172125;5896.233489646351;5036.665283699814;5607.7476513556885;5685.204071430003;5791.449812267839;5825.970870145654;5198.09033419152;5223.268742376061;5251.632385733;5257.5005374489365;5342.198670199462;5341.225522299264;5344.625876188668;5368.114261146906;5385.649932754359;5394.73026348681;5080.263361812554;5237.188235823453;5385.299911011563;5406.54044406224;5415.404305526408;5110.182370820688;5226.973865130688;5236.633435659505;5254.106801843695;5258.973705131488;5257.158854583248;5270.49930256625;5285.154375299933;5304.098303288451;5339.733013349317;5237.79048838046;5383.2732581101445;5484.890302193974;5653.095504719226;5694.459026392527;6292.402221788922;6294.055891616248;6299.149614801989;6306.810795676137;6327.778527751552;6303.5902666327;6309.211348581427;6310.9368906311265;6326.335734747831;6327.968360158216;5659.688717120557;5788.160716696056;5818.912716309259;5890.617109887844;5949.851253718648;6246.406591373812;6289.747711230756;6313.2424109107205;6356.396142366468;6390.45681117101;6191.907121393183;6220.315765265817;6227.252729672468;6230.906536401958;6232.283287421914;6129.48104857405;6138.447539721446;6195.504359651217;6340.968295158495;6346.333634968262;6286.748530058747;6300.27546832111;6323.715432805535;6327.841803954938;6328.71520781566;6030.788922387783;6277.874442511215;6311.936880631227;6323.557350985387;6335.904961425582;4919.385076865392;4939.975300123477;4993.875153121128;4999.225120106316;5021.924671129936;4493.438320209973;4511.954880451219;4514.45826500822;4541.2733962565835;4559.817607295738;5580.19087232349;5781.566382521328;5897.970510147422;5898.085796701518;5901.0558310670085;5759.992001399738;6158.815235542851;6247.718852651642;6247.812565623039;6270.404311590391;5488.890222195534;5592.720363981784;5875.853103672357;5896.734646940898;5903.026000709835;4688.718676879398;5483;5494.80768173112;5499.560035197174;5540.529055030368;6169.784057558054;6293.842653933688;6303.464205542488;6399.712012959428;6426.260979987362;6240.5319601031015;6270.12218289449;6281.560290779602;6284.214473190851;6287.905681414691;5681.0910254359105;5906.995810712275;6363.981762917911;6368.012957991518;6394.040893865771;6091.725872335667;6118.893302669218;6212.9068063979985;6215.9378406217165;6228.28374736893;6254.468370188585;6278.46633036197;6280.403361680633;6292;6301.6534090625455;5934.970325148347;6088.147659327787;6140.109684095692;6183.412575805291;6187.133801267736;5211.791528338976;6031.457168854824;6112.205413296243;6114.6942652868065;6120.969395152996;6062.151298818258;6062.666553339609;6095.207623008981;6112.388761123852;6113.694315284129;5858.531317494675;6001.069834175535;6001.159837622649;6011.27864656244;6186.969065154645;6058.848528786815;6125.632462052291;6126.724297406538;6135.11040899076;6154.415330543591 16:11:29 INFO - 2015-11-18 16:11:29,690 DEBUG : BROWSER_OUTPUT: |1;ext.html;545.8246870113394;587.5857520448085;588.6703446070198;595.8063629320471;621.6705146272476;40458.797706011464;40580.797096014554;40919.59080409195;40981.59018409815;40995.18009639809;44017.7799111004;44094.33858492117;44430.88983771137;44459;44607.55392446074;9860.556274967626;10032.648857289996;10038.598456061749;10044.799104017915;10057;9856.211503079772;9914.256430767686;9936.652217172401;9967.551460184273;9995.600175992951;9726.9513652432;9787.853182202272;9841.70474885751;9865.260105492081;9884;9792.363496372749;9866.013398660112;9873.308868379216;9894.901050989542;9907.702768916944;9733.415995040321;9875.25935554829;9883.258755593288;9901.504924753806;9902.851457228147;40441.79779101086;40880.38679419811;41045;41199.558015469614;41483.377749333784;3259.8533066012087;3270.5748252726994;3285.4743241081314;3293.275479394529;3445.913852153716;28746.712532874823;29598.85200574005;29685.81256749749;30262.940797072;30749.92375266855;2535.9105345826356;2549.6303036059667;2612.4905643399543;2636.657234559514;2680.2227354067295;485206;489689;491759;491803;492678.9999999964;54470.72764636151;55482.44517554773;61124.69437652872;61268.38731612716;66683.66658166776;65950;66460;66645.66677166583;66878.66560667165;66891.33108668949;16084.517464476085;16103.67792644164;16155.676886462204;16172.838271617133;16314.510564683078;12169.817452738216;12220.450079746433;12256;12362.938185309016;12376.690582735324;15956.840431595767;19925.60148797045;19964.201431942558;20062;20180.798192018185;7004.474664400089;7463.589502577411;7798.610069496503;8110.905027821169;8429.704960326359;762.5462849604477;933.4352716606355;1003.4681618742078;1058.4601853054844;1117.944102794857;26452.941882324878;27535.586966195522;28687.856560717064;31244;31246.28145452022;1026.4918865161792;1058.4125810175274;1080.2492267873752;1135.5798354608849;1224.5714000099895;13481;14470.384330785662;14838;14999.775003374958;15001.249937503082;453319.46680532774;499237;544694;549489;549490;55651;56017.719911400185;56134;56172.71913640487;56396;1419.6450887278181;1434.390384086759;1455.0687559961632;1471.234957821948;1479.970400591982;29071.383575477463;29297.853510733163;29634.110976670734;29641.851790740908;29889.10332690023;50426;50621.746891265306;50745;51103.744481277354;51206.231906522175;503517;504577;506782;506985;507732;26856;27960.580591291553;28371.57442638321;30976.69023309828;32863.342733144724;42264.78867605765;42504.78747606242;43724.78137609291;43853.342199867664;43987.56012439835;34671.65328346785;36400.81799590985;36448.453273201456;36643;37204;35500.64499354974;35931.46102808512;35936;36044.63955360518;36208.81895590505;34702.30595388129;35016.82491587628;35422.760203392754;35593.82203088968;35622.465663015595;31797.841010794797;33271.33457330888;33746.83126584352;33863.83068084742;33888.49167262542;24333.14833980802;24442.388940276636;24593.631095533223;24743.752562474147;24848.627270591318 16:11:29 INFO - 2015-11-18 16:11:29,691 DEBUG : BROWSER_OUTPUT: |2;jquery.html;353.53333599648465;358.1672611179009;362.6772172766239;362.9546306711658;366.81475854693383;15911.60220994473;18839;19178.23287068519;19461.902690486546;19469.929153896548;10454.268201225917;12621.737826217397;12758.681032974157;12828.422720977554;20035.39893803188;4120.299549076664;4138.193052354792;4138.896527586804;4171.374293855915;4752.263399173125;3668.52309199805;3733.7946412947276;4786.521347865203;5172.301739265207;5272;5201.349831271091;5203.713795741232;5221.503957124086;5233.136532472156;5236.502532259429;4849.490803465638;5164.483551644824;5198.1423065194385;5214.009338225725;5225.137852254412;4330.631896288819;4347.478302603708;4361.302191649353;4392.450943632046;4415.845445409427;13662.590122296348;13809.171449713049;13929.791053134211;13985.230812305319;14308;1881.7365568820376;1890.9243630254912;1907;1910.8757930734596;2103.3584756649216;9939.801203975952;10036.347637403545;10209.387436753745;10348.430836304;10402.583896644124;1556.4707999280186;1601.4475006122868;1608.9758653620206;1623.5048310265365;1635.7382818748943;91361.08638913592;93847.53076234575;93855.59216611757;95791.9999999993;96476.51761741146;6753.324667533306;6780.186377634617;6829.521933464709;6853.040574319599;6860.588364698134;6639.236487803964;7609.391248700091;7626.923730762733;7668.118166410823;7681.500702454323;5697.743601537941;5715.228444160069;5735.283089613798;5744.827655170351;5758.395368486333;6235.875282494325;6250.3749625037135;6255.968720156461;6299.559030867887;6302.873942521124;3051.633803943497;3073.462144124769;3075.9077227683206;3091.397177550356;3100.643426005993;1083.4420273558965;1107.983380249297;1131.1968502363413;1151.2344291046527;1157.7279339355246;434.40486533448745;441.46141707117266;447.6061066261669;473.54066555441165;482.04554981136846;11827.408629568487;12313.44589493475;12812.55156069533;12882.420291086924;12973.41619627119;467.26172647217317;495.655519414011;498.35960790384905;500.12478163214377;502.83406475862876;6423.176946844582;6550.6069635822005;6564.573302735307;6599.274079851212;6634.23706273775;694064;768325;774705;775609;776862;115334;116097;121743.78256217501;123832;126499.36750316374;459.53357342297596;513.4942082049179;521.5801279969585;524.9212618107238;528.355406404194;11563.074954003492;11714.472848721658;11851.70370740704;11905.226160299553;12280.570180043656;49646.50353496419;49789;50261.4921552354;50685;51151.23273150831;65569.67215163894;67997.9800302986;68320.97518537127;68767.96848047384;69906;6357.745690172526;6397.776077837253;6416;6448.032795080775;6463.515236357198;12196.634100976986;12246.816297755362;12291;12486.687832804253;12525.49898004106;8981.775455613662;9173.495457749621;9516;10269.383836969806;10593.629222977159;9078.81842363136;10324.48377581103;10398.376097434179;10774.784504310026;10875.782484350428;9922.751931201778;9950.701478955643;10056.245781566266;10067.84898226542;10076.496175191065;6152.046432802923;6181.350958149509;6241.095041218907;6250.06249062626;6261.436470717657;10640.89359106399;10669.89330106689;10811.29726567802;10965.835512467478;11046.613368532062 16:11:29 INFO - 2015-11-18 16:11:29,695 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1516.666333406651;1555.276796289725;1839.7976222615514;1845.963080738386;1846.1599972012737;7223.3860121889575;7229.349358557729;7818.609069546521;7895.723649672255;7933.841323173533;7726.61366931654;7814.804629884242;7897.842043159133;7903.565303908297;7908.209179082089;1900.1829213438216;2022.4539374368912;2033.8610378188262;2286.942826429336;2327.5228578141523;2313.5835549601065;2340.742518322983;2365.077619728307;2367.1478267823654;2369.7748713872243;2318.420394901275;2322.5006623576014;2342.3324352559525;2368;2369.6327069304284;2289.4734211131367;2321.663358812971;2326.592846251899;2330.731965823935;2335.836491445591;2349.3774149850306;2351.318117745852;2366.290112966103;2367.2661474942824;2373.7507561705943;7234.168070671835;7832.686692532292;7854.293113619745;7907;7924.524528528307;4932.654714170009;4996.125678006334;5018.84943451697;5035.0685123252315;5035.420926593452;2869.253993961564;2984.4329577380227;3036.8937087201843;3339.482380231068;3470.7570470067108;1051.4742628685658;1056.1550759392533;1056.5087234436023;1060.363781730963;1062.9627963021335;10106.343087699275;10278;10301.639442619547;10333.431661258628;10357.63748268807;4392.604665580113;4433.246348120827;4534.682572219913;4536.432945881765;4548.476925153584;9065.68270110543;9075;9095.135962083592;9162.86255706165;9178;4977.278294647256;4977.477364876709;4977.751112444435;4979.651424400257;5034.622403319692;4534.569215924482;4536.954630453653;4546.977265113654;4565.315202719618;4599.034202817379;3603.6396360363756;3661.2494438640015;3679.392900171495;3692.3353796316383;3703.0742314421395;1226.0926914083514;1238.5665017243894;1239.6281115665265;1248.918820276679;1249.6688377579949;1360.3810266328796;1368.1927662679068;1371.1567386057502;1385.47352006239;1393.2546087842954;7334.633268336562;7390.889136662954;7436.405087593088;7443.069616297963;7444.516106453063;477.58927322503314;483.5672073494203;483.8161498630568;484.493704079231;500.3720330984591;5835.620684655484;5882.441168089024;5925.703714814242;5967.6121052131475;5979.940200597938;8683.435576687496;9257.351985361094;9363.34456588046;9379.062093790702;9440.622375105057;9148.679796207101;9169.541522923828;9211.263098952068;9226.492542910204;9251.98228194898;7271.163816161209;7526.623668816646;7541.886871696929;7545.358644515168;7546.358559522502;7106.751263705745;7176.497645164788;7193.82015449597;7194.208637050025;7207.387372073223;8213.630386632496;8423.031351394424;8425.536595487307;8439.071702112886;8557.973043234852;7236.638168091469;8584.227419532272;8633.481991080555;8659.307255419426;8785.472871627722;6936.237013928363;6972.372486476242;6979.651017449209;7010.439164866901;7012.859742805217;7305;7341.229170936975;7370.96314518424;7405.222451642716;7430.665620047002;6947.895781563179;7083.787486375417;7127.429805615642;7131.8573628528175;7159.319864612853;5931.970340148272;6960.965195173992;7032.894506582303;7047.894281585678;7105.46708996817;7119.2168861426235;7156.355927966508;7164.104486939133;7198.460115491254;7212.8918066228;5704.229928959538;6557.9344206557325;6573.57271777333;6599.208095028627;6600.207975043026;6559.048937904073;6609.272979972103;6640.667966601554;6647.7008534617025;6697.464202863662 16:11:29 INFO - 2015-11-18 16:11:29,696 DEBUG : BROWSER_OUTPUT: |4;prototype.html;303.6826516290477;322.10133726901944;325.29086591231106;331.63851401971846;333.25849983786065;5867.677277749722;6788.287229840864;6918.273581273963;6991.440684745221;6991.580505169693;6559.114519539872;6829.317068293169;6872.003559483872;6923.792286231408;6933.653317334126;4752.120857641347;4847.345608342882;4867.2942423348595;5009.824656137036;5012.799488020484;4963.404391473028;4991.351124353847;5001.524855138774;5012.649114561982;5033;4418.315161150027;4579.267317229244;4937.111319962405;4960.87597810054;4968.22992436173;4960.107180707471;4974.054929563389;4974.626902982291;4987.351644286219;4992.975035124819;4063.2889244382113;4177.081042170717;4178.958210417887;4200.306949353353;4222.514410842762;6563.081168636347;6563.735511248611;6584.86830263392;6586.93413065868;6593.93406065938;5031.52200540948;5830.679312637845;5834.154047663065;5854.550541588381;5859.794907178229;5180.559652429511;6984.126984126984;7236.131664200329;7237.4933754637195;7239.9276007240305;4678.087772884289;4684.765761711901;4684.882877928079;4687.859364219079;4705.364775755298;7642.350400215988;7657.923420765776;7726.613669316568;7763.146053934062;7779.299863012356;3956.7625942443547;3996.680265578747;4690.179218636725;4728.40894888139;4735.810567577328;4629.213033784197;4821.108095002436;4825.541573550507;4826.975865120722;4831.782569784368;5800.187973683687;5802.535797136219;5804.912926306109;5809.738561764731;5844.766209351578;5601.887962240732;6454.32229615893;7117.181524124689;7332.706691732271;7357;1630.5271471273197;1657.1796960504628;1685.5280521454013;1687.7552754850478;1694.3138029098236;1050.6900464362877;1070.026276088771;1080.3517889266534;1081.1458947431597;1082.1342925659442;6575.309592492815;6762.256151823295;6771.559848609923;6778.051072849805;6787.151606049244;7590.203028682019;7665.156832748393;7681.961590192013;7682.001339825899;7696.345810606049;6873.656317184221;6909.896351554731;6922.826929326807;6948.791536253921;6951.582905025613;3891.8832435026993;4049.9392509112386;4059.6806038037757;4062.6343629073526;4071.776052317151;7194.820129496805;7221.783346499614;7926.207379262028;7957.084935232407;7987.083100056061;7692.615369231516;7921.643526041342;7924.405669574805;7933.920660793434;7962.442629015914;7940.245676660708;7950.24472675095;7954.602269886483;7980.281774640311;8001.039875214895;7612.086549614081;7641.2740789624895;7641.579713115832;7642.363384632293;7653.693852245848;7258.709651613876;7486.8876966844455;7495.400367970658;7507.662155203138;7554.508956917783;7915.129335773176;7934.960325198337;7938.364930805637;7938.920610794049;7952.926354942008;4720.834770783006;4725.40932383452;4728.59806916416;4742.976285118691;4744.881377965578;6583.275839657538;6866.588004719732;7219.314165154302;7651.120121186135;7658.502197357154;7330.523515971445;7343.779686609197;7344.669489872862;7354.338109570164;7368.889466658112;7116.644167791486;7257.911313303047;7330;7347.742829000959;7461.328480436787;6691.5315927884585;7144.285571442814;7162.964185179249;7169.318914703095;7175.103112110986;6987.301269872972;7141.464390170862;7196.8920466194095;7259.346658800522;7282.308180722823;6264.091706702411;6802.707485577725;7071.964640176766;7144.64276786169;7159.534630249017 16:11:29 INFO - 2015-11-18 16:11:29,697 DEBUG : BROWSER_OUTPUT: |5;yui.html;694.2120693013431;725.0791494801603;765.5674543882706;810.3962547901814;824.740206834847;15070.924645376772;15323.770143447857;15422.151781652034;15442.61393465164;15487.690246195069;14195;14256.857431425682;15890.682186356295;16177.595560111004;16182.35270589175;903.5617725403174;910.1353713971753;910.9933523456584;913.7624217703411;915.1717695485596;910.1171863292628;913.2830727878617;915.5330781301518;937.976550586234;941.4586612697692;960.9615615375377;962.1052421248237;967.4340510801189;972.4894430424014;972.7665360313509;953.9952300238489;960.1166926427668;962.7641227899139;965.0397854135146;965.9565319560567;694.9367467774314;703.9401650859683;704.0706267726603;708.2810946888912;712.6258714175048;15114.924425377803;15119.773203401957;15230.847691523053;15252;15260.542183734395;10300.587976480932;10367.79264414715;10381.948090259575;10446.68659940203;10866.61966831165;9660.647509348697;9683.854742178873;10086.445245511493;10134.949325253401;10553.47232638365;3065.754739620825;3104.7050530199595;3106.4874295741174;3130.8266778339457;3147.3862596793633;57559.71220143914;76891.61554192193;77575.61212193959;77803;77970;7011.3339232772805;7032.964835175791;7130.572165670076;7167.641617919187;7271.63641817907;12273.877261227273;12339.07456940715;12365.876341236652;12374.505019799288;12431.75136497265;6461.741530338733;6478.838029049311;6584;6695.933040669628;6773.864522709617;3949.2891279569953;4003.339448990942;4004.519457665099;4005.419214213981;4010.1779135277197;2739.986300068487;2885.3796433766843;3011.8192908425563;3030.5454181872897;3046.070948360727;463.37213076281154;466.8762777863801;483.63243934609244;484.06333744205074;484.6195736346951;493.3093668863548;498.34218831143266;571.6912867051745;586.642148289543;636.5925807483214;8755.343349248831;8863.581826907664;8866.689665861664;8874.740124740032;8957.641694332153;537.3551737914519;575.4993155954263;604.9485793707496;622.0824284180798;625.6027422586599;3799.2781371539318;4205.894852628709;4241.851535196253;4252.128313695685;4325.632321252666;96207.55688664675;97488;99697;100725;100872;78710.6064469674;81734;82146.58926705447;82723.58638206891;85319;75296.62351688207;75679;75693.24306756862;75792;76634.4673106546;7083.858322833411;8344.958275208584;8399.70601028961;8423.284020858297;8424.83150337002;51129;51207.46377608678;52609.47390526199;52683.68290792761;52753.736231318595;66633.66683166553;70973;74103.62948185224;74567;75028;7477.177510473953;7637.236276372319;7705.884411733717;7746.535207887545;7775.533467991939;11189.160812938899;11487.36819474937;11508.194426390408;12092.153549251469;12369;10970.232083754061;10985.83521247166;11034.503447344729;11041.33751974852;11188.328700278009;10388.428636424767;10780.353178808982;11042.227044106836;11079.279846809932;11230.494627741935;9605.47169905662;9924.603015879284;10059.396436213558;10123.291369604058;10132.290739648448;8620.706893965955;8975.237104846161;9264.305177111608;9420.576074076545;9438.197753190781;8988.955055224944;9302.488363140092;9341.859872101788;9413.2469402449;9477.810443791224 16:11:29 INFO - 2015-11-18 16:11:29,697 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,324 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: __startTimestamp1447891889684__endTimestamp 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: Number of tests: 6 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,698 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5775.84 Median:6001.16 stddev:630.53 (10.5%) stddev-sans-first:602.84 16:11:29 INFO - 2015-11-18 16:11:29,700 DEBUG : BROWSER_OUTPUT: Values: 3340.8 3445.8 3502.3 3546.1 3550.7 5810.9 5852.7 5854.4 5854.8 5896.2 5036.7 5607.7 5685.2 5791.4 5826.0 5198.1 5223.3 5251.6 5257.5 5342.2 5341.2 5344.6 5368.1 5385.6 5394.7 5080.3 5237.2 5385.3 5406.5 5415.4 5110.2 5227.0 5236.6 5254.1 5259.0 5257.2 5270.5 5285.2 5304.1 5339.7 5237.8 5383.3 5484.9 5653.1 5694.5 6292.4 6294.1 6299.1 6306.8 6327.8 6303.6 6309.2 6310.9 6326.3 6328.0 5659.7 5788.2 5818.9 5890.6 5949.9 6246.4 6289.7 6313.2 6356.4 6390.5 6191.9 6220.3 6227.3 6230.9 6232.3 6129.5 6138.4 6195.5 6341.0 6346.3 6286.7 6300.3 6323.7 6327.8 6328.7 6030.8 6277.9 6311.9 6323.6 6335.9 4919.4 4940.0 4993.9 4999.2 5021.9 4493.4 4512.0 4514.5 4541.3 4559.8 5580.2 5781.6 5898.0 5898.1 5901.1 5760.0 6158.8 6247.7 6247.8 6270.4 5488.9 5592.7 5875.9 5896.7 5903.0 4688.7 5483.0 5494.8 5499.6 5540.5 6169.8 6293.8 6303.5 6399.7 6426.3 6240.5 6270.1 6281.6 6284.2 6287.9 5681.1 5907.0 6364.0 6368.0 6394.0 6091.7 6118.9 6212.9 6215.9 6228.3 6254.5 6278.5 6280.4 6292.0 6301.7 5935.0 6088.1 6140.1 6183.4 6187.1 5211.8 6031.5 6112.2 6114.7 6121.0 6062.2 6062.7 6095.2 6112.4 6113.7 5858.5 6001.1 6001.2 6011.3 6187.0 6058.8 6125.6 6126.7 6135.1 6154.4 16:11:29 INFO - 2015-11-18 16:11:29,700 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,700 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:64741.03 Median:36923.50 stddev:134538.90 (364.4%) stddev-sans-first:134829.98 16:11:29 INFO - 2015-11-18 16:11:29,701 DEBUG : BROWSER_OUTPUT: Values: 545.8 587.6 588.7 595.8 621.7 40458.8 40580.8 40919.6 40981.6 40995.2 44017.8 44094.3 44430.9 44459.0 44607.6 9860.6 10032.6 10038.6 10044.8 10057.0 9856.2 9914.3 9936.7 9967.6 9995.6 9727.0 9787.9 9841.7 9865.3 9884.0 9792.4 9866.0 9873.3 9894.9 9907.7 9733.4 9875.3 9883.3 9901.5 9902.9 40441.8 40880.4 41045.0 41199.6 41483.4 3259.9 3270.6 3285.5 3293.3 3445.9 28746.7 29598.9 29685.8 30262.9 30749.9 2535.9 2549.6 2612.5 2636.7 2680.2 485206.0 489689.0 491759.0 491803.0 492679.0 54470.7 55482.4 61124.7 61268.4 66683.7 65950.0 66460.0 66645.7 66878.7 66891.3 16084.5 16103.7 16155.7 16172.8 16314.5 12169.8 12220.5 12256.0 12362.9 12376.7 15956.8 19925.6 19964.2 20062.0 20180.8 7004.5 7463.6 7798.6 8110.9 8429.7 762.5 933.4 1003.5 1058.5 1117.9 26452.9 27535.6 28687.9 31244.0 31246.3 1026.5 1058.4 1080.2 1135.6 1224.6 13481.0 14470.4 14838.0 14999.8 15001.2 453319.5 499237.0 544694.0 549489.0 549490.0 55651.0 56017.7 56134.0 56172.7 56396.0 1419.6 1434.4 1455.1 1471.2 1480.0 29071.4 29297.9 29634.1 29641.9 29889.1 50426.0 50621.7 50745.0 51103.7 51206.2 503517.0 504577.0 506782.0 506985.0 507732.0 26856.0 27960.6 28371.6 30976.7 32863.3 42264.8 42504.8 43724.8 43853.3 43987.6 34671.7 36400.8 36448.5 36643.0 37204.0 35500.6 35931.5 35936.0 36044.6 36208.8 34702.3 35016.8 35422.8 35593.8 35622.5 31797.8 33271.3 33746.8 33863.8 33888.5 24333.1 24442.4 24593.6 24743.8 24848.6 16:11:29 INFO - 2015-11-18 16:11:29,701 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,701 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:36218.80 Median:2431.73 stddev:125184.28 (5148.0%) stddev-sans-first:125506.48 16:11:29 INFO - 2015-11-18 16:11:29,702 DEBUG : BROWSER_OUTPUT: Values: 353.5 358.2 362.7 363.0 366.8 15911.6 18839.0 19178.2 19461.9 19469.9 10454.3 12621.7 12758.7 12828.4 20035.4 4120.3 4138.2 4138.9 4171.4 4752.3 3668.5 3733.8 4786.5 5172.3 5272.0 5201.3 5203.7 5221.5 5233.1 5236.5 4849.5 5164.5 5198.1 5214.0 5225.1 4330.6 4347.5 4361.3 4392.5 4415.8 13662.6 13809.2 13929.8 13985.2 14308.0 1881.7 1890.9 1907.0 1910.9 2103.4 9939.8 10036.3 10209.4 10348.4 10402.6 1556.5 1601.4 1609.0 1623.5 1635.7 91361.1 93847.5 93855.6 95792.0 96476.5 6753.3 6780.2 6829.5 6853.0 6860.6 6639.2 7609.4 7626.9 7668.1 7681.5 5697.7 5715.2 5735.3 5744.8 5758.4 6235.9 6250.4 6256.0 6299.6 6302.9 3051.6 3073.5 3075.9 3091.4 3100.6 1083.4 1108.0 1131.2 1151.2 1157.7 434.4 441.5 447.6 473.5 482.0 11827.4 12313.4 12812.6 12882.4 12973.4 467.3 495.7 498.4 500.1 502.8 6423.2 6550.6 6564.6 6599.3 6634.2 694064.0 768325.0 774705.0 775609.0 776862.0 115334.0 116097.0 121743.8 123832.0 126499.4 459.5 513.5 521.6 524.9 528.4 11563.1 11714.5 11851.7 11905.2 12280.6 49646.5 49789.0 50261.5 50685.0 51151.2 65569.7 67998.0 68321.0 68768.0 69906.0 6357.7 6397.8 6416.0 6448.0 6463.5 12196.6 12246.8 12291.0 12486.7 12525.5 8981.8 9173.5 9516.0 10269.4 10593.6 9078.8 10324.5 10398.4 10774.8 10875.8 9922.8 9950.7 10056.2 10067.8 10076.5 6152.0 6181.4 6241.1 6250.1 6261.4 10640.9 10669.9 10811.3 10965.8 11046.6 16:11:29 INFO - 2015-11-18 16:11:29,703 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,703 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5486.28 Median:5973.78 stddev:2790.36 (46.7%) stddev-sans-first:2782.24 16:11:29 INFO - 2015-11-18 16:11:29,704 DEBUG : BROWSER_OUTPUT: Values: 1516.7 1555.3 1839.8 1846.0 1846.2 7223.4 7229.3 7818.6 7895.7 7933.8 7726.6 7814.8 7897.8 7903.6 7908.2 1900.2 2022.5 2033.9 2286.9 2327.5 2313.6 2340.7 2365.1 2367.1 2369.8 2318.4 2322.5 2342.3 2368.0 2369.6 2289.5 2321.7 2326.6 2330.7 2335.8 2349.4 2351.3 2366.3 2367.3 2373.8 7234.2 7832.7 7854.3 7907.0 7924.5 4932.7 4996.1 5018.8 5035.1 5035.4 2869.3 2984.4 3036.9 3339.5 3470.8 1051.5 1056.2 1056.5 1060.4 1063.0 10106.3 10278.0 10301.6 10333.4 10357.6 4392.6 4433.2 4534.7 4536.4 4548.5 9065.7 9075.0 9095.1 9162.9 9178.0 4977.3 4977.5 4977.8 4979.7 5034.6 4534.6 4537.0 4547.0 4565.3 4599.0 3603.6 3661.2 3679.4 3692.3 3703.1 1226.1 1238.6 1239.6 1248.9 1249.7 1360.4 1368.2 1371.2 1385.5 1393.3 7334.6 7390.9 7436.4 7443.1 7444.5 477.6 483.6 483.8 484.5 500.4 5835.6 5882.4 5925.7 5967.6 5979.9 8683.4 9257.4 9363.3 9379.1 9440.6 9148.7 9169.5 9211.3 9226.5 9252.0 7271.2 7526.6 7541.9 7545.4 7546.4 7106.8 7176.5 7193.8 7194.2 7207.4 8213.6 8423.0 8425.5 8439.1 8558.0 7236.6 8584.2 8633.5 8659.3 8785.5 6936.2 6972.4 6979.7 7010.4 7012.9 7305.0 7341.2 7371.0 7405.2 7430.7 6947.9 7083.8 7127.4 7131.9 7159.3 5932.0 6961.0 7032.9 7047.9 7105.5 7119.2 7156.4 7164.1 7198.5 7212.9 5704.2 6557.9 6573.6 6599.2 6600.2 6559.0 6609.3 6640.7 6647.7 6697.5 16:11:29 INFO - 2015-11-18 16:11:29,704 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,704 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5923.68 Median:6774.81 stddev:1930.40 (28.5%) stddev-sans-first:1889.17 16:11:29 INFO - 2015-11-18 16:11:29,704 DEBUG : BROWSER_OUTPUT: Values: 303.7 322.1 325.3 331.6 333.3 5867.7 6788.3 6918.3 6991.4 6991.6 6559.1 6829.3 6872.0 6923.8 6933.7 4752.1 4847.3 4867.3 5009.8 5012.8 4963.4 4991.4 5001.5 5012.6 5033.0 4418.3 4579.3 4937.1 4960.9 4968.2 4960.1 4974.1 4974.6 4987.4 4993.0 4063.3 4177.1 4179.0 4200.3 4222.5 6563.1 6563.7 6584.9 6586.9 6593.9 5031.5 5830.7 5834.2 5854.6 5859.8 5180.6 6984.1 7236.1 7237.5 7239.9 4678.1 4684.8 4684.9 4687.9 4705.4 7642.4 7657.9 7726.6 7763.1 7779.3 3956.8 3996.7 4690.2 4728.4 4735.8 4629.2 4821.1 4825.5 4827.0 4831.8 5800.2 5802.5 5804.9 5809.7 5844.8 5601.9 6454.3 7117.2 7332.7 7357.0 1630.5 1657.2 1685.5 1687.8 1694.3 1050.7 1070.0 1080.4 1081.1 1082.1 6575.3 6762.3 6771.6 6778.1 6787.2 7590.2 7665.2 7682.0 7682.0 7696.3 6873.7 6909.9 6922.8 6948.8 6951.6 3891.9 4049.9 4059.7 4062.6 4071.8 7194.8 7221.8 7926.2 7957.1 7987.1 7692.6 7921.6 7924.4 7933.9 7962.4 7940.2 7950.2 7954.6 7980.3 8001.0 7612.1 7641.3 7641.6 7642.4 7653.7 7258.7 7486.9 7495.4 7507.7 7554.5 7915.1 7935.0 7938.4 7938.9 7952.9 4720.8 4725.4 4728.6 4743.0 4744.9 6583.3 6866.6 7219.3 7651.1 7658.5 7330.5 7343.8 7344.7 7354.3 7368.9 7116.6 7257.9 7330.0 7347.7 7461.3 6691.5 7144.3 7163.0 7169.3 7175.1 6987.3 7141.5 7196.9 7259.3 7282.3 6264.1 6802.7 7072.0 7144.6 7159.5 16:11:29 INFO - 2015-11-18 16:11:29,705 DEBUG : BROWSER_OUTPUT: 16:11:29 INFO - 2015-11-18 16:11:29,705 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:18198.25 Median:6531.42 stddev:26880.94 (411.6%) stddev-sans-first:26924.21 16:11:29 INFO - 2015-11-18 16:11:29,706 DEBUG : BROWSER_OUTPUT: Values: 694.2 725.1 765.6 810.4 824.7 15070.9 15323.8 15422.2 15442.6 15487.7 14195.0 14256.9 15890.7 16177.6 16182.4 903.6 910.1 911.0 913.8 915.2 910.1 913.3 915.5 938.0 941.5 961.0 962.1 967.4 972.5 972.8 954.0 960.1 962.8 965.0 966.0 694.9 703.9 704.1 708.3 712.6 15114.9 15119.8 15230.8 15252.0 15260.5 10300.6 10367.8 10381.9 10446.7 10866.6 9660.6 9683.9 10086.4 10134.9 10553.5 3065.8 3104.7 3106.5 3130.8 3147.4 57559.7 76891.6 77575.6 77803.0 77970.0 7011.3 7033.0 7130.6 7167.6 7271.6 12273.9 12339.1 12365.9 12374.5 12431.8 6461.7 6478.8 6584.0 6695.9 6773.9 3949.3 4003.3 4004.5 4005.4 4010.2 2740.0 2885.4 3011.8 3030.5 3046.1 463.4 466.9 483.6 484.1 484.6 493.3 498.3 571.7 586.6 636.6 8755.3 8863.6 8866.7 8874.7 8957.6 537.4 575.5 604.9 622.1 625.6 3799.3 4205.9 4241.9 4252.1 4325.6 96207.6 97488.0 99697.0 100725.0 100872.0 78710.6 81734.0 82146.6 82723.6 85319.0 75296.6 75679.0 75693.2 75792.0 76634.5 7083.9 8345.0 8399.7 8423.3 8424.8 51129.0 51207.5 52609.5 52683.7 52753.7 66633.7 70973.0 74103.6 74567.0 75028.0 7477.2 7637.2 7705.9 7746.5 7775.5 11189.2 11487.4 11508.2 12092.2 12369.0 10970.2 10985.8 11034.5 11041.3 11188.3 10388.4 10780.4 11042.2 11079.3 11230.5 9605.5 9924.6 10059.4 10123.3 10132.3 8620.7 8975.2 9264.3 9420.6 9438.2 8989.0 9302.5 9341.9 9413.2 9477.8 16:11:29 INFO - 2015-11-18 16:11:29,706 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:11:29 INFO - 2015-11-18 16:11:29,706 DEBUG : BROWSER_OUTPUT: 16:11:30 INFO - 2015-11-18 16:11:30,144 INFO : Browser exited with error code: 0 16:11:30 INFO - 2015-11-18 16:11:30,169 INFO : Completed test dromaeo_css (00:18:29) 16:11:30 INFO - 2015-11-18 16:11:30,169 INFO : Starting test kraken 16:11:30 INFO - 2015-11-18 16:11:30,169 DEBUG : operating with platform_type : mac_ 16:11:30 INFO - 2015-11-18 16:11:30,169 INFO : Initialising browser for kraken test... 16:11:30 INFO - 2015-11-18 16:11:30,182 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/tmpYSxEDm/profile http://localhost:49264/getInfo.html 16:11:32 INFO - 2015-11-18 16:11:32,920 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:11:32 INFO - 2015-11-18 16:11:32,920 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:11:32 INFO - 2015-11-18 16:11:32,922 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:11:32 INFO - 2015-11-18 16:11:32,922 DEBUG : BROWSER_OUTPUT: __metrics 16:11:33 INFO - 2015-11-18 16:11:33,491 INFO : Browser initialized. 16:11:33 INFO - 2015-11-18 16:11:33,492 INFO : Running cycle 1/1 for kraken test... 16:11:33 INFO - 2015-11-18 16:11:33,492 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/tmpYSxEDm/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:11:45 INFO - 2015-11-18 16:11:45,459 DEBUG : BROWSER_OUTPUT: RSS: Main: 236912640 16:11:45 INFO - 2015-11-18 16:11:45,459 DEBUG : BROWSER_OUTPUT: 16:11:48 INFO - 2015-11-18 16:11:48,203 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49264/tests/kraken/driver.html?testName=audio-beat-detection) 16:11:48 INFO - 2015-11-18 16:11:48,815 DEBUG : BROWSER_OUTPUT: RSS: Main: 249221120 16:11:48 INFO - 2015-11-18 16:11:48,815 DEBUG : BROWSER_OUTPUT: 16:11:51 INFO - 2015-11-18 16:11:51,609 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49264/tests/kraken/driver.html?testName=audio-dft) 16:11:52 INFO - 2015-11-18 16:11:52,210 DEBUG : BROWSER_OUTPUT: RSS: Main: 259063808 16:11:52 INFO - 2015-11-18 16:11:52,211 DEBUG : BROWSER_OUTPUT: 16:11:55 INFO - 2015-11-18 16:11:55,469 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49264/tests/kraken/driver.html?testName=audio-fft) 16:11:56 INFO - 2015-11-18 16:11:56,041 DEBUG : BROWSER_OUTPUT: RSS: Main: 261271552 16:11:56 INFO - 2015-11-18 16:11:56,041 DEBUG : BROWSER_OUTPUT: 16:11:57 INFO - 2015-11-18 16:11:57,895 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49264/tests/kraken/driver.html?testName=audio-oscillator) 16:11:58 INFO - 2015-11-18 16:11:58,497 DEBUG : BROWSER_OUTPUT: RSS: Main: 262217728 16:11:58 INFO - 2015-11-18 16:11:58,497 DEBUG : BROWSER_OUTPUT: 16:12:00 INFO - 2015-11-18 16:12:00,630 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49264/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:12:01 INFO - 2015-11-18 16:12:01,217 DEBUG : BROWSER_OUTPUT: RSS: Main: 264196096 16:12:01 INFO - 2015-11-18 16:12:01,217 DEBUG : BROWSER_OUTPUT: 16:12:04 INFO - 2015-11-18 16:12:04,144 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49264/tests/kraken/driver.html?testName=imaging-darkroom) 16:12:04 INFO - 2015-11-18 16:12:04,737 DEBUG : BROWSER_OUTPUT: RSS: Main: 263548928 16:12:04 INFO - 2015-11-18 16:12:04,738 DEBUG : BROWSER_OUTPUT: 16:12:07 INFO - 2015-11-18 16:12:07,588 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49264/tests/kraken/driver.html?testName=imaging-desaturate) 16:12:08 INFO - 2015-11-18 16:12:08,179 DEBUG : BROWSER_OUTPUT: RSS: Main: 263331840 16:12:08 INFO - 2015-11-18 16:12:08,179 DEBUG : BROWSER_OUTPUT: 16:12:11 INFO - 2015-11-18 16:12:11,340 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49264/tests/kraken/driver.html?testName=json-parse-financial) 16:12:11 INFO - 2015-11-18 16:12:11,928 DEBUG : BROWSER_OUTPUT: RSS: Main: 263806976 16:12:11 INFO - 2015-11-18 16:12:11,928 DEBUG : BROWSER_OUTPUT: 16:12:13 INFO - 2015-11-18 16:12:13,521 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49264/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:12:14 INFO - 2015-11-18 16:12:14,107 DEBUG : BROWSER_OUTPUT: RSS: Main: 265506816 16:12:14 INFO - 2015-11-18 16:12:14,108 DEBUG : BROWSER_OUTPUT: 16:12:15 INFO - 2015-11-18 16:12:15,849 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49264/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:12:16 INFO - 2015-11-18 16:12:16,472 DEBUG : BROWSER_OUTPUT: RSS: Main: 264695808 16:12:16 INFO - 2015-11-18 16:12:16,473 DEBUG : BROWSER_OUTPUT: 16:12:18 INFO - 2015-11-18 16:12:18,608 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49264/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:12:19 INFO - 2015-11-18 16:12:19,206 DEBUG : BROWSER_OUTPUT: RSS: Main: 264699904 16:12:19 INFO - 2015-11-18 16:12:19,206 DEBUG : BROWSER_OUTPUT: 16:12:21 INFO - 2015-11-18 16:12:21,722 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49264/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:12:22 INFO - 2015-11-18 16:12:22,324 DEBUG : BROWSER_OUTPUT: RSS: Main: 264499200 16:12:22 INFO - 2015-11-18 16:12:22,324 DEBUG : BROWSER_OUTPUT: 16:12:24 INFO - 2015-11-18 16:12:24,767 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49264/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:12:25 INFO - 2015-11-18 16:12:25,354 DEBUG : BROWSER_OUTPUT: RSS: Main: 264978432 16:12:25 INFO - 2015-11-18 16:12:25,354 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,096 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49264/tests/kraken/driver.html?testName=ai-astar) 16:12:27 INFO - 2015-11-18 16:12:27,345 DEBUG : BROWSER_OUTPUT: RSS: Main: 265195520 16:12:27 INFO - 2015-11-18 16:12:27,345 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,346 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |0;ai-astar;113;108;116;115;116;127;115;116;116;115 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;164;152;174;146;133;168;165;159;155;139 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |2;audio-dft;198;193;198;215;236;195;161;162;203;281 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |3;audio-fft;63;65;70;107;68;56;58;61;109;76 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;80;70;134;110;114;110;116;77;60;124 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;116;129;91;86;133;129;90;88;89;89 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;149;119;95;97;96;96;95;95;95;95 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;87;100;143;145;92;124;152;92;144;145 16:12:27 INFO - 2015-11-18 16:12:27,347 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;60;59;59;60;59;60;57;71;85;85 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;65;65;64;64;68;67;67;67;66;69 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;85;85;73;85;98;107;107;86;82;87 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;129;137;127;121;124;125;125;130;134;128 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;142;140;140;137;140;137;145;144;142;138 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;68;66;73;88;92;92;76;67;67;68 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,816 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: __startTimestamp1447891947345__endTimestamp 16:12:27 INFO - 2015-11-18 16:12:27,348 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,350 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:12:27 INFO - 2015-11-18 16:12:27,350 DEBUG : BROWSER_OUTPUT: Number of tests: 14 16:12:27 INFO - 2015-11-18 16:12:27,350 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:115.70 Median:116.00 stddev:4.67 (4.0%) stddev-sans-first:4.85 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: Values: 113.0 108.0 116.0 115.0 116.0 127.0 115.0 116.0 116.0 115.0 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:155.50 Median:161.50 stddev:13.14 (8.1%) stddev-sans-first:13.57 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: Values: 164.0 152.0 174.0 146.0 133.0 168.0 165.0 159.0 155.0 139.0 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:204.20 Median:200.50 stddev:34.90 (17.4%) stddev-sans-first:36.94 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: Values: 198.0 193.0 198.0 215.0 236.0 195.0 161.0 162.0 203.0 281.0 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:73.30 Median:64.00 stddev:19.20 (30.0%) stddev-sans-first:19.99 16:12:27 INFO - 2015-11-18 16:12:27,351 DEBUG : BROWSER_OUTPUT: Values: 63.0 65.0 70.0 107.0 68.0 56.0 58.0 61.0 109.0 76.0 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:99.50 Median:97.00 stddev:25.41 (26.2%) stddev-sans-first:25.95 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: Values: 80.0 70.0 134.0 110.0 114.0 110.0 116.0 77.0 60.0 124.0 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:104.00 Median:88.50 stddev:20.08 (22.7%) stddev-sans-first:20.83 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: Values: 116.0 129.0 91.0 86.0 133.0 129.0 90.0 88.0 89.0 89.0 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:103.20 Median:95.00 stddev:17.72 (18.7%) stddev-sans-first:7.87 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: Values: 149.0 119.0 95.0 97.0 96.0 96.0 95.0 95.0 95.0 95.0 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:122.40 Median:148.50 stddev:26.65 (17.9%) stddev-sans-first:25.00 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: Values: 87.0 100.0 143.0 145.0 92.0 124.0 152.0 92.0 144.0 145.0 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,352 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:65.50 Median:60.00 stddev:10.96 (18.3%) stddev-sans-first:11.44 16:12:27 INFO - 2015-11-18 16:12:27,353 DEBUG : BROWSER_OUTPUT: Values: 60.0 59.0 59.0 60.0 59.0 60.0 57.0 71.0 85.0 85.0 16:12:27 INFO - 2015-11-18 16:12:27,353 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,353 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:66.20 Median:67.00 stddev:1.69 (2.5%) stddev-sans-first:1.73 16:12:27 INFO - 2015-11-18 16:12:27,353 DEBUG : BROWSER_OUTPUT: Values: 65.0 65.0 64.0 64.0 68.0 67.0 67.0 67.0 66.0 69.0 16:12:27 INFO - 2015-11-18 16:12:27,353 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,354 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:89.50 Median:85.00 stddev:11.02 (13.0%) stddev-sans-first:11.57 16:12:27 INFO - 2015-11-18 16:12:27,354 DEBUG : BROWSER_OUTPUT: Values: 85.0 85.0 73.0 85.0 98.0 107.0 107.0 86.0 82.0 87.0 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:128.00 Median:128.50 stddev:4.78 (3.7%) stddev-sans-first:5.06 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: Values: 129.0 137.0 127.0 121.0 124.0 125.0 125.0 130.0 134.0 128.0 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:140.50 Median:141.00 stddev:2.76 (2.0%) stddev-sans-first:2.87 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: Values: 142.0 140.0 140.0 137.0 140.0 137.0 145.0 144.0 142.0 138.0 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:75.70 Median:74.50 stddev:10.82 (14.5%) stddev-sans-first:11.11 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: Values: 68.0 66.0 73.0 88.0 92.0 92.0 76.0 67.0 67.0 68.0 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:12:27 INFO - 2015-11-18 16:12:27,355 DEBUG : BROWSER_OUTPUT: 16:12:27 INFO - 2015-11-18 16:12:27,964 INFO : Browser exited with error code: 0 16:12:28 INFO - 2015-11-18 16:12:28,007 INFO : Completed test kraken (00:00:57) 16:12:28 INFO - 2015-11-18 16:12:28,008 INFO : Starting test v8_7 16:12:28 INFO - 2015-11-18 16:12:28,008 DEBUG : operating with platform_type : mac_ 16:12:28 INFO - 2015-11-18 16:12:28,008 INFO : Initialising browser for v8_7 test... 16:12:28 INFO - 2015-11-18 16:12:28,021 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/tmpSNXi4t/profile http://localhost:49264/getInfo.html 16:12:30 INFO - 2015-11-18 16:12:30,525 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:12:30 INFO - 2015-11-18 16:12:30,526 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:12:30 INFO - 2015-11-18 16:12:30,526 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:12:30 INFO - 2015-11-18 16:12:30,526 DEBUG : BROWSER_OUTPUT: __metrics 16:12:31 INFO - 2015-11-18 16:12:31,160 INFO : Browser initialized. 16:12:31 INFO - 2015-11-18 16:12:31,160 INFO : Running cycle 1/1 for v8_7 test... 16:12:31 INFO - 2015-11-18 16:12:31,160 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/T/tmpSNXi4t/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:12:43 INFO - 2015-11-18 16:12:43,016 DEBUG : BROWSER_OUTPUT: RSS: Main: 237006848 16:12:43 INFO - 2015-11-18 16:12:43,016 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,393 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49264/tests/v8_7/run.html (next: http://localhost:49264/tests/v8_7/run.html) 16:13:04 INFO - 2015-11-18 16:13:04,650 DEBUG : BROWSER_OUTPUT: RSS: Main: 249913344 16:13:04 INFO - 2015-11-18 16:13:04,650 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,650 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:13:04 INFO - 2015-11-18 16:13:04,650 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:13:04 INFO - 2015-11-18 16:13:04,650 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |0;Richards;146.90759512266783 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;159.23566878980893 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |2;Encrypt;282.326369282891 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |3;Decrypt;4817.307692307692 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |4;RayTrace;975.609756097561 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |5;Earley;719.4244604316547 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |6;Boyer;13794.520547945205 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |7;RegExp;27405.405405405407 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |8;Splay;788.0220646178093 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4542.986425339366 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:13:04 INFO - 2015-11-18 16:13:04,651 DEBUG : BROWSER_OUTPUT: __startTimestamp1447891984645__endTimestamp 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: Number of tests: 10 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:146.91 Median:146.91 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: Values: 146.9 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:159.24 Median:159.24 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: Values: 159.2 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:282.33 Median:282.33 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: Values: 282.3 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,652 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:4817.31 Median:4817.31 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: Values: 4817.3 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:975.61 Median:975.61 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: Values: 975.6 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:719.42 Median:719.42 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: Values: 719.4 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:13794.52 Median:13794.52 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: Values: 13794.5 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:27405.41 Median:27405.41 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: Values: 27405.4 16:13:04 INFO - 2015-11-18 16:13:04,653 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,654 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:788.02 Median:788.02 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,654 DEBUG : BROWSER_OUTPUT: Values: 788.0 16:13:04 INFO - 2015-11-18 16:13:04,654 DEBUG : BROWSER_OUTPUT: 16:13:04 INFO - 2015-11-18 16:13:04,654 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4542.99 Median:4542.99 stddev:0.00 (0.0%) 16:13:04 INFO - 2015-11-18 16:13:04,654 DEBUG : BROWSER_OUTPUT: Values: 4543.0 16:13:04 INFO - 2015-11-18 16:13:04,654 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:13:04 INFO - 2015-11-18 16:13:04,654 DEBUG : BROWSER_OUTPUT: 16:13:05 INFO - 2015-11-18 16:13:05,269 INFO : Browser exited with error code: 0 16:13:05 INFO - 2015-11-18 16:13:05,286 INFO : Completed test v8_7 (00:00:37) 16:13:05 INFO - 2015-11-18 16:13:05,745 INFO : Completed test suite (00:20:04) 16:13:05 INFO - 2015-11-18 16:13:05,745 DEBUG : Working with test: dromaeo_css 16:13:05 INFO - 2015-11-18 16:13:05,745 DEBUG : Generating results file: dromaeo_css 16:13:05 INFO - 2015-11-18 16:13:05,746 DEBUG : Working with test: kraken 16:13:05 INFO - 2015-11-18 16:13:05,746 DEBUG : Generating results file: kraken 16:13:05 INFO - 2015-11-18 16:13:05,746 INFO : javascript benchmark 16:13:05 INFO - 2015-11-18 16:13:05,746 DEBUG : Working with test: v8_7 16:13:05 INFO - 2015-11-18 16:13:05,747 DEBUG : Generating results file: v8_7 16:13:05 INFO - 2015-11-18 16:13:05,747 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:13:05 INFO - 2015-11-18 16:13:05,810 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,61]] 16:13:05 INFO - 2015-11-18 16:13:05,810 DEBUG : process_Request line: dromaeo_css 7093.08 graph.html#tests=[[72,64,61]] 16:13:05 INFO - 2015-11-18 16:13:05,810 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:13:05 INFO - 2015-11-18 16:13:05,845 DEBUG : process_Request line: kraken 1543.20 graph.html#tests=[[232,64,61]] 16:13:05 INFO - 2015-11-18 16:13:05,845 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:13:05 INFO - 2015-11-18 16:13:05,873 DEBUG : process_Request line: v8_7 21459.55 graph.html#tests=[[230,64,61]] 16:13:05 INFO - 2015-11-18 16:13:05,874 INFO : javascript benchmark 16:13:05 INFO - 2015-11-18 16:13:05,875 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3340.8496617652213, 3445.7587968842176, 3502.264524449867, 3546.1311978565254, 3550.7159427245824, 5810.854728631786, 5852.736626851792, 5854.443827836349, 5854.795082172125, 5896.233489646351, 5036.665283699814, 5607.7476513556885, 5685.204071430003, 5791.449812267839, 5825.970870145654, 5198.09033419152, 5223.268742376061, 5251.632385733, 5257.5005374489365, 5342.198670199462, 5341.225522299264, 5344.625876188668, 5368.114261146906, 5385.649932754359, 5394.73026348681, 5080.263361812554, 5237.188235823453, 5385.299911011563, 5406.54044406224, 5415.404305526408, 5110.182370820688, 5226.973865130688, 5236.633435659505, 5254.106801843695, 5258.973705131488, 5257.158854583248, 5270.49930256625, 5285.154375299933, 5304.098303288451, 5339.733013349317, 5237.79048838046, 5383.2732581101445, 5484.890302193974, 5653.095504719226, 5694.459026392527, 6292.402221788922, 6294.055891616248, 6299.149614801989, 6306.810795676137, 6327.778527751552, 6303.5902666327, 6309.211348581427, 6310.9368906311265, 6326.335734747831, 6327.968360158216, 5659.688717120557, 5788.160716696056, 5818.912716309259, 5890.617109887844, 5949.851253718648, 6246.406591373812, 6289.747711230756, 6313.2424109107205, 6356.396142366468, 6390.45681117101, 6191.907121393183, 6220.315765265817, 6227.252729672468, 6230.906536401958, 6232.283287421914, 6129.48104857405, 6138.447539721446, 6195.504359651217, 6340.968295158495, 6346.333634968262, 6286.748530058747, 6300.27546832111, 6323.715432805535, 6327.841803954938, 6328.71520781566, 6030.788922387783, 6277.874442511215, 6311.936880631227, 6323.557350985387, 6335.904961425582, 4919.385076865392, 4939.975300123477, 4993.875153121128, 4999.225120106316, 5021.924671129936, 4493.438320209973, 4511.954880451219, 4514.45826500822, 4541.2733962565835, 4559.817607295738, 5580.19087232349, 5781.566382521328, 5897.970510147422, 5898.085796701518, 5901.0558310670085, 5759.992001399738, 6158.815235542851, 6247.718852651642, 6247.812565623039, 6270.404311590391, 5488.890222195534, 5592.720363981784, 5875.853103672357, 5896.734646940898, 5903.026000709835, 4688.718676879398, 5483.0, 5494.80768173112, 5499.560035197174, 5540.529055030368, 6169.784057558054, 6293.842653933688, 6303.464205542488, 6399.712012959428, 6426.260979987362, 6240.5319601031015, 6270.12218289449, 6281.560290779602, 6284.214473190851, 6287.905681414691, 5681.0910254359105, 5906.995810712275, 6363.981762917911, 6368.012957991518, 6394.040893865771, 6091.725872335667, 6118.893302669218, 6212.9068063979985, 6215.9378406217165, 6228.28374736893, 6254.468370188585, 6278.46633036197, 6280.403361680633, 6292.0, 6301.6534090625455, 5934.970325148347, 6088.147659327787, 6140.109684095692, 6183.412575805291, 6187.133801267736, 5211.791528338976, 6031.457168854824, 6112.205413296243, 6114.6942652868065, 6120.969395152996, 6062.151298818258, 6062.666553339609, 6095.207623008981, 6112.388761123852, 6113.694315284129, 5858.531317494675, 6001.069834175535, 6001.159837622649, 6011.27864656244, 6186.969065154645, 6058.848528786815, 6125.632462052291, 6126.724297406538, 6135.11040899076, 6154.415330543591], "unit": "ms", "name": "dojo.html", "value": 5737.415014020164}, {"lowerIsBetter": false, "replicates": [545.8246870113394, 587.5857520448085, 588.6703446070198, 595.8063629320471, 621.6705146272476, 40458.797706011464, 40580.797096014554, 40919.59080409195, 40981.59018409815, 40995.18009639809, 44017.7799111004, 44094.33858492117, 44430.88983771137, 44459.0, 44607.55392446074, 9860.556274967626, 10032.648857289996, 10038.598456061749, 10044.799104017915, 10057.0, 9856.211503079772, 9914.256430767686, 9936.652217172401, 9967.551460184273, 9995.600175992951, 9726.9513652432, 9787.853182202272, 9841.70474885751, 9865.260105492081, 9884.0, 9792.363496372749, 9866.013398660112, 9873.308868379216, 9894.901050989542, 9907.702768916944, 9733.415995040321, 9875.25935554829, 9883.258755593288, 9901.504924753806, 9902.851457228147, 40441.79779101086, 40880.38679419811, 41045.0, 41199.558015469614, 41483.377749333784, 3259.8533066012087, 3270.5748252726994, 3285.4743241081314, 3293.275479394529, 3445.913852153716, 28746.712532874823, 29598.85200574005, 29685.81256749749, 30262.940797072, 30749.92375266855, 2535.9105345826356, 2549.6303036059667, 2612.4905643399543, 2636.657234559514, 2680.2227354067295, 485206.0, 489689.0, 491759.0, 491803.0, 492678.9999999964, 54470.72764636151, 55482.44517554773, 61124.69437652872, 61268.38731612716, 66683.66658166776, 65950.0, 66460.0, 66645.66677166583, 66878.66560667165, 66891.33108668949, 16084.517464476085, 16103.67792644164, 16155.676886462204, 16172.838271617133, 16314.510564683078, 12169.817452738216, 12220.450079746433, 12256.0, 12362.938185309016, 12376.690582735324, 15956.840431595767, 19925.60148797045, 19964.201431942558, 20062.0, 20180.798192018185, 7004.474664400089, 7463.589502577411, 7798.610069496503, 8110.905027821169, 8429.704960326359, 762.5462849604477, 933.4352716606355, 1003.4681618742078, 1058.4601853054844, 1117.944102794857, 26452.941882324878, 27535.586966195522, 28687.856560717064, 31244.0, 31246.28145452022, 1026.4918865161792, 1058.4125810175274, 1080.2492267873752, 1135.5798354608849, 1224.5714000099895, 13481.0, 14470.384330785662, 14838.0, 14999.775003374958, 15001.249937503082, 453319.46680532774, 499237.0, 544694.0, 549489.0, 549490.0, 55651.0, 56017.719911400185, 56134.0, 56172.71913640487, 56396.0, 1419.6450887278181, 1434.390384086759, 1455.0687559961632, 1471.234957821948, 1479.970400591982, 29071.383575477463, 29297.853510733163, 29634.110976670734, 29641.851790740908, 29889.10332690023, 50426.0, 50621.746891265306, 50745.0, 51103.744481277354, 51206.231906522175, 503517.0, 504577.0, 506782.0, 506985.0, 507732.0, 26856.0, 27960.580591291553, 28371.57442638321, 30976.69023309828, 32863.342733144724, 42264.78867605765, 42504.78747606242, 43724.78137609291, 43853.342199867664, 43987.56012439835, 34671.65328346785, 36400.81799590985, 36448.453273201456, 36643.0, 37204.0, 35500.64499354974, 35931.46102808512, 35936.0, 36044.63955360518, 36208.81895590505, 34702.30595388129, 35016.82491587628, 35422.760203392754, 35593.82203088968, 35622.465663015595, 31797.841010794797, 33271.33457330888, 33746.83126584352, 33863.83068084742, 33888.49167262542, 24333.14833980802, 24442.388940276636, 24593.631095533223, 24743.752562474147, 24848.627270591318], "unit": "ms", "name": "ext.html", "value": 19743.778580468643}, {"lowerIsBetter": false, "replicates": [353.53333599648465, 358.1672611179009, 362.6772172766239, 362.9546306711658, 366.81475854693383, 15911.60220994473, 18839.0, 19178.23287068519, 19461.902690486546, 19469.929153896548, 10454.268201225917, 12621.737826217397, 12758.681032974157, 12828.422720977554, 20035.39893803188, 4120.299549076664, 4138.193052354792, 4138.896527586804, 4171.374293855915, 4752.263399173125, 3668.52309199805, 3733.7946412947276, 4786.521347865203, 5172.301739265207, 5272.0, 5201.349831271091, 5203.713795741232, 5221.503957124086, 5233.136532472156, 5236.502532259429, 4849.490803465638, 5164.483551644824, 5198.1423065194385, 5214.009338225725, 5225.137852254412, 4330.631896288819, 4347.478302603708, 4361.302191649353, 4392.450943632046, 4415.845445409427, 13662.590122296348, 13809.171449713049, 13929.791053134211, 13985.230812305319, 14308.0, 1881.7365568820376, 1890.9243630254912, 1907.0, 1910.8757930734596, 2103.3584756649216, 9939.801203975952, 10036.347637403545, 10209.387436753745, 10348.430836304, 10402.583896644124, 1556.4707999280186, 1601.4475006122868, 1608.9758653620206, 1623.5048310265365, 1635.7382818748943, 91361.08638913592, 93847.53076234575, 93855.59216611757, 95791.9999999993, 96476.51761741146, 6753.324667533306, 6780.186377634617, 6829.521933464709, 6853.040574319599, 6860.588364698134, 6639.236487803964, 7609.391248700091, 7626.923730762733, 7668.118166410823, 7681.500702454323, 5697.743601537941, 5715.228444160069, 5735.283089613798, 5744.827655170351, 5758.395368486333, 6235.875282494325, 6250.3749625037135, 6255.968720156461, 6299.559030867887, 6302.873942521124, 3051.633803943497, 3073.462144124769, 3075.9077227683206, 3091.397177550356, 3100.643426005993, 1083.4420273558965, 1107.983380249297, 1131.1968502363413, 1151.2344291046527, 1157.7279339355246, 434.40486533448745, 441.46141707117266, 447.6061066261669, 473.54066555441165, 482.04554981136846, 11827.408629568487, 12313.44589493475, 12812.55156069533, 12882.420291086924, 12973.41619627119, 467.26172647217317, 495.655519414011, 498.35960790384905, 500.12478163214377, 502.83406475862876, 6423.176946844582, 6550.6069635822005, 6564.573302735307, 6599.274079851212, 6634.23706273775, 694064.0, 768325.0, 774705.0, 775609.0, 776862.0, 115334.0, 116097.0, 121743.78256217501, 123832.0, 126499.36750316374, 459.53357342297596, 513.4942082049179, 521.5801279969585, 524.9212618107238, 528.355406404194, 11563.074954003492, 11714.472848721658, 11851.70370740704, 11905.226160299553, 12280.570180043656, 49646.50353496419, 49789.0, 50261.4921552354, 50685.0, 51151.23273150831, 65569.67215163894, 67997.9800302986, 68320.97518537127, 68767.96848047384, 69906.0, 6357.745690172526, 6397.776077837253, 6416.0, 6448.032795080775, 6463.515236357198, 12196.634100976986, 12246.816297755362, 12291.0, 12486.687832804253, 12525.49898004106, 8981.775455613662, 9173.495457749621, 9516.0, 10269.383836969806, 10593.629222977159, 9078.81842363136, 10324.48377581103, 10398.376097434179, 10774.784504310026, 10875.782484350428, 9922.751931201778, 9950.701478955643, 10056.245781566266, 10067.84898226542, 10076.496175191065, 6152.046432802923, 6181.350958149509, 6241.095041218907, 6250.06249062626, 6261.436470717657, 10640.89359106399, 10669.89330106689, 10811.29726567802, 10965.835512467478, 11046.613368532062], "unit": "ms", "name": "jquery.html", "value": 7269.602077259589}, {"lowerIsBetter": false, "replicates": [1516.666333406651, 1555.276796289725, 1839.7976222615514, 1845.963080738386, 1846.1599972012737, 7223.3860121889575, 7229.349358557729, 7818.609069546521, 7895.723649672255, 7933.841323173533, 7726.61366931654, 7814.804629884242, 7897.842043159133, 7903.565303908297, 7908.209179082089, 1900.1829213438216, 2022.4539374368912, 2033.8610378188262, 2286.942826429336, 2327.5228578141523, 2313.5835549601065, 2340.742518322983, 2365.077619728307, 2367.1478267823654, 2369.7748713872243, 2318.420394901275, 2322.5006623576014, 2342.3324352559525, 2368.0, 2369.6327069304284, 2289.4734211131367, 2321.663358812971, 2326.592846251899, 2330.731965823935, 2335.836491445591, 2349.3774149850306, 2351.318117745852, 2366.290112966103, 2367.2661474942824, 2373.7507561705943, 7234.168070671835, 7832.686692532292, 7854.293113619745, 7907.0, 7924.524528528307, 4932.654714170009, 4996.125678006334, 5018.84943451697, 5035.0685123252315, 5035.420926593452, 2869.253993961564, 2984.4329577380227, 3036.8937087201843, 3339.482380231068, 3470.7570470067108, 1051.4742628685658, 1056.1550759392533, 1056.5087234436023, 1060.363781730963, 1062.9627963021335, 10106.343087699275, 10278.0, 10301.639442619547, 10333.431661258628, 10357.63748268807, 4392.604665580113, 4433.246348120827, 4534.682572219913, 4536.432945881765, 4548.476925153584, 9065.68270110543, 9075.0, 9095.135962083592, 9162.86255706165, 9178.0, 4977.278294647256, 4977.477364876709, 4977.751112444435, 4979.651424400257, 5034.622403319692, 4534.569215924482, 4536.954630453653, 4546.977265113654, 4565.315202719618, 4599.034202817379, 3603.6396360363756, 3661.2494438640015, 3679.392900171495, 3692.3353796316383, 3703.0742314421395, 1226.0926914083514, 1238.5665017243894, 1239.6281115665265, 1248.918820276679, 1249.6688377579949, 1360.3810266328796, 1368.1927662679068, 1371.1567386057502, 1385.47352006239, 1393.2546087842954, 7334.633268336562, 7390.889136662954, 7436.405087593088, 7443.069616297963, 7444.516106453063, 477.58927322503314, 483.5672073494203, 483.8161498630568, 484.493704079231, 500.3720330984591, 5835.620684655484, 5882.441168089024, 5925.703714814242, 5967.6121052131475, 5979.940200597938, 8683.435576687496, 9257.351985361094, 9363.34456588046, 9379.062093790702, 9440.622375105057, 9148.679796207101, 9169.541522923828, 9211.263098952068, 9226.492542910204, 9251.98228194898, 7271.163816161209, 7526.623668816646, 7541.886871696929, 7545.358644515168, 7546.358559522502, 7106.751263705745, 7176.497645164788, 7193.82015449597, 7194.208637050025, 7207.387372073223, 8213.630386632496, 8423.031351394424, 8425.536595487307, 8439.071702112886, 8557.973043234852, 7236.638168091469, 8584.227419532272, 8633.481991080555, 8659.307255419426, 8785.472871627722, 6936.237013928363, 6972.372486476242, 6979.651017449209, 7010.439164866901, 7012.859742805217, 7305.0, 7341.229170936975, 7370.96314518424, 7405.222451642716, 7430.665620047002, 6947.895781563179, 7083.787486375417, 7127.429805615642, 7131.8573628528175, 7159.319864612853, 5931.970340148272, 6960.965195173992, 7032.894506582303, 7047.894281585678, 7105.46708996817, 7119.2168861426235, 7156.355927966508, 7164.104486939133, 7198.460115491254, 7212.8918066228, 5704.229928959538, 6557.9344206557325, 6573.57271777333, 6599.208095028627, 6600.207975043026, 6559.048937904073, 6609.272979972103, 6640.667966601554, 6647.7008534617025, 6697.464202863662], "unit": "ms", "name": "mootools.html", "value": 4472.910508171043}, {"lowerIsBetter": false, "replicates": [303.6826516290477, 322.10133726901944, 325.29086591231106, 331.63851401971846, 333.25849983786065, 5867.677277749722, 6788.287229840864, 6918.273581273963, 6991.440684745221, 6991.580505169693, 6559.114519539872, 6829.317068293169, 6872.003559483872, 6923.792286231408, 6933.653317334126, 4752.120857641347, 4847.345608342882, 4867.2942423348595, 5009.824656137036, 5012.799488020484, 4963.404391473028, 4991.351124353847, 5001.524855138774, 5012.649114561982, 5033.0, 4418.315161150027, 4579.267317229244, 4937.111319962405, 4960.87597810054, 4968.22992436173, 4960.107180707471, 4974.054929563389, 4974.626902982291, 4987.351644286219, 4992.975035124819, 4063.2889244382113, 4177.081042170717, 4178.958210417887, 4200.306949353353, 4222.514410842762, 6563.081168636347, 6563.735511248611, 6584.86830263392, 6586.93413065868, 6593.93406065938, 5031.52200540948, 5830.679312637845, 5834.154047663065, 5854.550541588381, 5859.794907178229, 5180.559652429511, 6984.126984126984, 7236.131664200329, 7237.4933754637195, 7239.9276007240305, 4678.087772884289, 4684.765761711901, 4684.882877928079, 4687.859364219079, 4705.364775755298, 7642.350400215988, 7657.923420765776, 7726.613669316568, 7763.146053934062, 7779.299863012356, 3956.7625942443547, 3996.680265578747, 4690.179218636725, 4728.40894888139, 4735.810567577328, 4629.213033784197, 4821.108095002436, 4825.541573550507, 4826.975865120722, 4831.782569784368, 5800.187973683687, 5802.535797136219, 5804.912926306109, 5809.738561764731, 5844.766209351578, 5601.887962240732, 6454.32229615893, 7117.181524124689, 7332.706691732271, 7357.0, 1630.5271471273197, 1657.1796960504628, 1685.5280521454013, 1687.7552754850478, 1694.3138029098236, 1050.6900464362877, 1070.026276088771, 1080.3517889266534, 1081.1458947431597, 1082.1342925659442, 6575.309592492815, 6762.256151823295, 6771.559848609923, 6778.051072849805, 6787.151606049244, 7590.203028682019, 7665.156832748393, 7681.961590192013, 7682.001339825899, 7696.345810606049, 6873.656317184221, 6909.896351554731, 6922.826929326807, 6948.791536253921, 6951.582905025613, 3891.8832435026993, 4049.9392509112386, 4059.6806038037757, 4062.6343629073526, 4071.776052317151, 7194.820129496805, 7221.783346499614, 7926.207379262028, 7957.084935232407, 7987.083100056061, 7692.615369231516, 7921.643526041342, 7924.405669574805, 7933.920660793434, 7962.442629015914, 7940.245676660708, 7950.24472675095, 7954.602269886483, 7980.281774640311, 8001.039875214895, 7612.086549614081, 7641.2740789624895, 7641.579713115832, 7642.363384632293, 7653.693852245848, 7258.709651613876, 7486.8876966844455, 7495.400367970658, 7507.662155203138, 7554.508956917783, 7915.129335773176, 7934.960325198337, 7938.364930805637, 7938.920610794049, 7952.926354942008, 4720.834770783006, 4725.40932383452, 4728.59806916416, 4742.976285118691, 4744.881377965578, 6583.275839657538, 6866.588004719732, 7219.314165154302, 7651.120121186135, 7658.502197357154, 7330.523515971445, 7343.779686609197, 7344.669489872862, 7354.338109570164, 7368.889466658112, 7116.644167791486, 7257.911313303047, 7330.0, 7347.742829000959, 7461.328480436787, 6691.5315927884585, 7144.285571442814, 7162.964185179249, 7169.318914703095, 7175.103112110986, 6987.301269872972, 7141.464390170862, 7196.8920466194095, 7259.346658800522, 7282.308180722823, 6264.091706702411, 6802.707485577725, 7071.964640176766, 7144.64276786169, 7159.534630249017], "unit": "ms", "name": "prototype.html", "value": 5272.694315528208}, {"lowerIsBetter": false, "replicates": [694.2120693013431, 725.0791494801603, 765.5674543882706, 810.3962547901814, 824.740206834847, 15070.924645376772, 15323.770143447857, 15422.151781652034, 15442.61393465164, 15487.690246195069, 14195.0, 14256.857431425682, 15890.682186356295, 16177.595560111004, 16182.35270589175, 903.5617725403174, 910.1353713971753, 910.9933523456584, 913.7624217703411, 915.1717695485596, 910.1171863292628, 913.2830727878617, 915.5330781301518, 937.976550586234, 941.4586612697692, 960.9615615375377, 962.1052421248237, 967.4340510801189, 972.4894430424014, 972.7665360313509, 953.9952300238489, 960.1166926427668, 962.7641227899139, 965.0397854135146, 965.9565319560567, 694.9367467774314, 703.9401650859683, 704.0706267726603, 708.2810946888912, 712.6258714175048, 15114.924425377803, 15119.773203401957, 15230.847691523053, 15252.0, 15260.542183734395, 10300.587976480932, 10367.79264414715, 10381.948090259575, 10446.68659940203, 10866.61966831165, 9660.647509348697, 9683.854742178873, 10086.445245511493, 10134.949325253401, 10553.47232638365, 3065.754739620825, 3104.7050530199595, 3106.4874295741174, 3130.8266778339457, 3147.3862596793633, 57559.71220143914, 76891.61554192193, 77575.61212193959, 77803.0, 77970.0, 7011.3339232772805, 7032.964835175791, 7130.572165670076, 7167.641617919187, 7271.63641817907, 12273.877261227273, 12339.07456940715, 12365.876341236652, 12374.505019799288, 12431.75136497265, 6461.741530338733, 6478.838029049311, 6584.0, 6695.933040669628, 6773.864522709617, 3949.2891279569953, 4003.339448990942, 4004.519457665099, 4005.419214213981, 4010.1779135277197, 2739.986300068487, 2885.3796433766843, 3011.8192908425563, 3030.5454181872897, 3046.070948360727, 463.37213076281154, 466.8762777863801, 483.63243934609244, 484.06333744205074, 484.6195736346951, 493.3093668863548, 498.34218831143266, 571.6912867051745, 586.642148289543, 636.5925807483214, 8755.343349248831, 8863.581826907664, 8866.689665861664, 8874.740124740032, 8957.641694332153, 537.3551737914519, 575.4993155954263, 604.9485793707496, 622.0824284180798, 625.6027422586599, 3799.2781371539318, 4205.894852628709, 4241.851535196253, 4252.128313695685, 4325.632321252666, 96207.55688664675, 97488.0, 99697.0, 100725.0, 100872.0, 78710.6064469674, 81734.0, 82146.58926705447, 82723.58638206891, 85319.0, 75296.62351688207, 75679.0, 75693.24306756862, 75792.0, 76634.4673106546, 7083.858322833411, 8344.958275208584, 8399.70601028961, 8423.284020858297, 8424.83150337002, 51129.0, 51207.46377608678, 52609.47390526199, 52683.68290792761, 52753.736231318595, 66633.66683166553, 70973.0, 74103.62948185224, 74567.0, 75028.0, 7477.177510473953, 7637.236276372319, 7705.884411733717, 7746.535207887545, 7775.533467991939, 11189.160812938899, 11487.36819474937, 11508.194426390408, 12092.153549251469, 12369.0, 10970.232083754061, 10985.83521247166, 11034.503447344729, 11041.33751974852, 11188.328700278009, 10388.428636424767, 10780.353178808982, 11042.227044106836, 11079.279846809932, 11230.494627741935, 9605.47169905662, 9924.603015879284, 10059.396436213558, 10123.291369604058, 10132.290739648448, 8620.706893965955, 8975.237104846161, 9264.305177111608, 9420.576074076545, 9438.197753190781, 8988.955055224944, 9302.488363140092, 9341.859872101788, 9413.2469402449, 9477.810443791224], "unit": "ms", "name": "yui.html", "value": 6556.8136194589815}], "name": "dromaeo_css", "value": 7093.07842833727}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [113.0, 108.0, 116.0, 115.0, 116.0, 127.0, 115.0, 116.0, 116.0, 115.0], "unit": "ms", "name": "ai-astar", "value": 115.7}, {"lowerIsBetter": true, "replicates": [164.0, 152.0, 174.0, 146.0, 133.0, 168.0, 165.0, 159.0, 155.0, 139.0], "unit": "ms", "name": "audio-beat-detection", "value": 155.5}, {"lowerIsBetter": true, "replicates": [198.0, 193.0, 198.0, 215.0, 236.0, 195.0, 161.0, 162.0, 203.0, 281.0], "unit": "ms", "name": "audio-dft", "value": 204.2}, {"lowerIsBetter": true, "replicates": [63.0, 65.0, 70.0, 107.0, 68.0, 56.0, 58.0, 61.0, 109.0, 76.0], "unit": "ms", "name": "audio-fft", "value": 73.3}, {"lowerIsBetter": true, "replicates": [80.0, 70.0, 134.0, 110.0, 114.0, 110.0, 116.0, 77.0, 60.0, 124.0], "unit": "ms", "name": "audio-oscillator", "value": 99.5}, {"lowerIsBetter": true, "replicates": [116.0, 129.0, 91.0, 86.0, 133.0, 129.0, 90.0, 88.0, 89.0, 89.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 104.0}, {"lowerIsBetter": true, "replicates": [149.0, 119.0, 95.0, 97.0, 96.0, 96.0, 95.0, 95.0, 95.0, 95.0], "unit": "ms", "name": "imaging-darkroom", "value": 103.2}, {"lowerIsBetter": true, "replicates": [87.0, 100.0, 143.0, 145.0, 92.0, 124.0, 152.0, 92.0, 144.0, 145.0], "unit": "ms", "name": "imaging-desaturate", "value": 122.4}, {"lowerIsBetter": true, "replicates": [60.0, 59.0, 59.0, 60.0, 59.0, 60.0, 57.0, 71.0, 85.0, 85.0], "unit": "ms", "name": "json-parse-financial", "value": 65.5}, {"lowerIsBetter": true, "replicates": [65.0, 65.0, 64.0, 64.0, 68.0, 67.0, 67.0, 67.0, 66.0, 69.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 66.2}, {"lowerIsBetter": true, "replicates": [85.0, 85.0, 73.0, 85.0, 98.0, 107.0, 107.0, 86.0, 82.0, 87.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 89.5}, {"lowerIsBetter": true, "replicates": [129.0, 137.0, 127.0, 121.0, 124.0, 125.0, 125.0, 130.0, 134.0, 128.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 128.0}, {"lowerIsBetter": true, "replicates": [142.0, 140.0, 140.0, 137.0, 140.0, 137.0, 145.0, 144.0, 142.0, 138.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 140.5}, {"lowerIsBetter": true, "replicates": [68.0, 66.0, 73.0, 88.0, 92.0, 92.0, 76.0, 67.0, 67.0, 68.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 75.7}], "name": "kraken", "value": 1543.2}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [146.90759512266783], "unit": "score", "name": "Richards", "value": 240.30071400000006}, {"lowerIsBetter": false, "replicates": [159.23566878980893], "unit": "score", "name": "DeltaBlue", "value": 415.22103999999996}, {"lowerIsBetter": false, "replicates": [282.326369282891], "unit": "score", "name": "Encrypt", "value": 942.813102}, {"lowerIsBetter": false, "replicates": [4817.307692307692], "unit": "score", "name": "Decrypt", "value": 55.25513772455092}, {"lowerIsBetter": false, "replicates": [975.609756097561], "unit": "score", "name": "RayTrace", "value": 758.4887250000003}, {"lowerIsBetter": false, "replicates": [719.4244604316547], "unit": "score", "name": "Earley", "value": 926.3835699999998}, {"lowerIsBetter": false, "replicates": [13794.520547945205], "unit": "score", "name": "Boyer", "value": 48.31360377358492}, {"lowerIsBetter": false, "replicates": [27405.405405405407], "unit": "score", "name": "RegExp", "value": 33.241070019723885}, {"lowerIsBetter": false, "replicates": [788.0220646178093], "unit": "score", "name": "Splay", "value": 103.41207900000002}, {"lowerIsBetter": false, "replicates": [4542.986425339366], "unit": "score", "name": "NavierStokes", "value": 326.65737051792814}], "name": "v8_7", "value": 21459.54699827896}]} 16:13:05 INFO - RETURN: dromaeo_css: 7093.08 16:13:05 INFO - RETURN: kraken: 1543.20 16:13:05 INFO - RETURN: v8_7: 21459.55 16:13:05 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,61]]", "result": "21459.55"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,61]]", "result": "1543.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,61]]", "result": "7093.08"}}} 16:13:05 INFO - Return code: 0 16:13:05 INFO - # TBPL SUCCESS # 16:13:05 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:13:05 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:13:05 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:13:05 INFO - 2015-11-18 16:13:05.982 screenresolution[1682:10674] starting screenresolution argv=screenresolution get 16:13:05 INFO - 2015-11-18 16:13:05.984 screenresolution[1682:10674] Display 0: 1600x1200x32@60 16:13:05 INFO - 2015-11-18 16:13:05.990 screenresolution[1683:10677] starting screenresolution argv=screenresolution list 16:13:05 INFO - Available Modes on Display 0 16:13:05 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:13:05 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:13:05 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:13:05 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:13:06 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:13:06 INFO - Intel Iris: 16:13:06 INFO - Chipset Model: Intel Iris 16:13:06 INFO - Type: GPU 16:13:06 INFO - Bus: Built-In 16:13:06 INFO - VRAM (Dynamic, Max): 1536 MB 16:13:06 INFO - Vendor: Intel (0x8086) 16:13:06 INFO - Device ID: 0x0a2e 16:13:06 INFO - Revision ID: 0x0009 16:13:06 INFO - Displays: 16:13:06 INFO - Display: 16:13:06 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:13:06 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:13:06 INFO - Display Serial Number: 1600x1200 60 16:13:06 INFO - Main Display: Yes 16:13:06 INFO - Mirror: Off 16:13:06 INFO - Online: Yes 16:13:06 INFO - Rotation: Supported 16:13:06 INFO - Return code: 0 16:13:06 INFO - Running post-action listener: _resource_record_post_action 16:13:06 INFO - Running post-run listener: _resource_record_post_run 16:13:07 INFO - Total resource usage - Wall time: 1236s; CPU: 53.0%; Read bytes: 38942208; Write bytes: 690184192; Read time: 423; Write time: 2678 16:13:07 INFO - install - Wall time: 31s; CPU: 54.0%; Read bytes: 332921344; Write bytes: 333407744; Read time: 26265; Write time: 581 16:13:07 INFO - run-tests - Wall time: 1206s; CPU: 53.0%; Read bytes: 37975552; Write bytes: 345299456; Read time: 406; Write time: 2062 16:13:07 INFO - Running post-run listener: _upload_blobber_files 16:13:07 INFO - Blob upload gear active. 16:13:07 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 16:13:07 INFO - Copying logs to upload dir... 16:13:07 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1278.843678 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 18 secs) (at 2015-11-18 16:13:07.355770) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-18 16:13:07.363805) ========= 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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners TMPDIR=/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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 build_url:https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.009297 build_url: 'https://queue.taskcluster.net/v1/task/k0j2RmoLSL-r0UcRmGd-9w/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-18 16:13:07.391921) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 16:13:07.392346) ========= 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.F3nnS6kF7g/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.HbbZpTd0zY/Listeners TMPDIR=/var/folders/mg/4p66s20s2m19br0bc1hxf60m00000w/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.005036 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 16:13:07.441151) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-18 16:13:07.444510) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-18 16:13:07.444925) ========= ========= Total master_lag: 6.89 =========