builder: fx-team_yosemite_test-dromaeojs slave: t-yosemite-r5-0010 starttime: 1447262672.86 results: success (0) buildid: 20151111072432 builduid: c70918fee84b43089c81ee020cb6fbe4 revision: 94ec640656f15a9466debc0ea251de1b8d76fbc7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.862312) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.862905) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.863307) ========= 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.4YUf7TilnE/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.AQf6oxO7QV/Listeners TMPDIR=/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/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:0x0:0x0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.005950 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.888229) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.888643) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.904700) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.905177) ========= 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.4YUf7TilnE/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.AQf6oxO7QV/Listeners TMPDIR=/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.005256 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.956081) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.956541) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.957058) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:32.957463) ========= 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.4YUf7TilnE/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.AQf6oxO7QV/Listeners TMPDIR=/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/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:0x0:0x0 using PTY: False --2015-11-11 09:24:32-- 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% 32.4M=0s 2015-11-11 09:24:33 (32.4 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.113233 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.087452) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.087869) ========= 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.4YUf7TilnE/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.AQf6oxO7QV/Listeners TMPDIR=/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.020609 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.137935) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.138440) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 94ec640656f15a9466debc0ea251de1b8d76fbc7 --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 94ec640656f15a9466debc0ea251de1b8d76fbc7 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.4YUf7TilnE/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.AQf6oxO7QV/Listeners TMPDIR=/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/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:0x0:0x0 using PTY: False 2015-11-11 09:24:33,209 truncating revision to first 12 chars 2015-11-11 09:24:33,210 Setting DEBUG logging. 2015-11-11 09:24:33,210 attempt 1/10 2015-11-11 09:24:33,210 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/94ec640656f1?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-11 09:24:33,488 unpacking tar archive at: fx-team-94ec640656f1/testing/mozharness/ program finished with exit code 0 elapsedTime=0.520306 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.679042) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.679473) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.693174) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.693574) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 09:24:33.694091) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 29 mins, 31 secs) (at 2015-11-11 09:24:33.694507) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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.4YUf7TilnE/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.AQf6oxO7QV/Listeners TMPDIR=/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/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:0x0:0x0 using PTY: False 09:24:33 INFO - MultiFileLogger online at 20151111 09:24:33 in /builds/slave/test 09:24:33 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --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 09:24:33 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:24:33 INFO - {'append_to_log': False, 09:24:33 INFO - 'base_work_dir': '/builds/slave/test', 09:24:33 INFO - 'blob_upload_branch': 'Fx-Team', 09:24:33 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:24:33 INFO - 'branch': 'Fx-Team', 09:24:33 INFO - 'buildbot_json_path': 'buildprops.json', 09:24:33 INFO - 'config_files': ('talos/mac_config.py',), 09:24:33 INFO - 'default_actions': ('clobber', 09:24:33 INFO - 'read-buildbot-config', 09:24:33 INFO - 'download-and-extract', 09:24:33 INFO - 'populate-webroot', 09:24:33 INFO - 'create-virtualenv', 09:24:33 INFO - 'install', 09:24:33 INFO - 'run-tests'), 09:24:33 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:24:33 INFO - 'download_minidump_stackwalk': True, 09:24:33 INFO - 'download_symbols': 'ondemand', 09:24:33 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:24:33 INFO - 'tooltool.py': '/tools/tooltool.py', 09:24:33 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:24:33 INFO - '/tools/misc-python/virtualenv.py')}, 09:24:33 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:24:33 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:24:33 INFO - 'installer_path': 'installer.exe', 09:24:33 INFO - 'log_level': 'info', 09:24:33 INFO - 'log_name': 'talos', 09:24:33 INFO - 'log_to_console': True, 09:24:33 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 09:24:33 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 09:24:33 INFO - 'opt_config_files': (), 09:24:33 INFO - 'pip_index': False, 09:24:33 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 09:24:33 INFO - 'cmd': ('bash', 09:24:33 INFO - '-c', 09:24:33 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 09:24:33 INFO - 'enabled': True, 09:24:33 INFO - 'halt_on_failure': False, 09:24:33 INFO - 'name': 'check_screen_resolution'},), 09:24:33 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 09:24:33 INFO - 'cmd': ('bash', 09:24:33 INFO - '-c', 09:24:33 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 09:24:33 INFO - 'enabled': True, 09:24:33 INFO - 'halt_on_failure': False, 09:24:33 INFO - 'name': 'check_screen_resolution'},), 09:24:33 INFO - 'run_cmd_checks_enabled': True, 09:24:33 INFO - 'sps_profile': False, 09:24:33 INFO - 'sps_profile_interval': 0, 09:24:33 INFO - 'suite': 'dromaeojs', 09:24:33 INFO - 'system_bits': '64', 09:24:33 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:24:33 INFO - 'title': 't-yosemite-r5-0010', 09:24:33 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:24:33 INFO - 'use_talos_json': True, 09:24:33 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:24:33 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:24:33 INFO - 'work_dir': 'build'} 09:24:33 INFO - ##### 09:24:33 INFO - ##### Running clobber step. 09:24:33 INFO - ##### 09:24:33 INFO - Running pre-action listener: _resource_record_pre_action 09:24:33 INFO - Running main action method: clobber 09:24:33 INFO - rmtree: /builds/slave/test/build 09:24:33 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:24:35 INFO - Running post-action listener: _resource_record_post_action 09:24:35 INFO - ##### 09:24:35 INFO - ##### Running read-buildbot-config step. 09:24:35 INFO - ##### 09:24:35 INFO - Running pre-action listener: _resource_record_pre_action 09:24:35 INFO - Running main action method: read_buildbot_config 09:24:35 INFO - Using buildbot properties: 09:24:35 INFO - { 09:24:35 INFO - "properties": { 09:24:35 INFO - "buildnumber": 1332, 09:24:35 INFO - "product": "firefox", 09:24:35 INFO - "script_repo_revision": "production", 09:24:35 INFO - "builddir": "fx-team_yosemite_test-dromaeojs", 09:24:35 INFO - "repository": "", 09:24:35 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 fx-team talos dromaeojs", 09:24:35 INFO - "buildid": "20151111072432", 09:24:35 INFO - "slavename": "t-yosemite-r5-0010", 09:24:35 INFO - "pgo_build": "False", 09:24:35 INFO - "basedir": "/builds/slave/test", 09:24:35 INFO - "project": "", 09:24:35 INFO - "platform": "yosemite", 09:24:35 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 09:24:35 INFO - "slavebuilddir": "test", 09:24:35 INFO - "scheduler": "tests-fx-team-macosx64-talos", 09:24:35 INFO - "branch": "fx-team", 09:24:35 INFO - "repo_path": "integration/fx-team", 09:24:35 INFO - "stage_platform": "macosx64", 09:24:35 INFO - "builduid": "c70918fee84b43089c81ee020cb6fbe4", 09:24:35 INFO - "revision": "94ec640656f15a9466debc0ea251de1b8d76fbc7" 09:24:35 INFO - }, 09:24:35 INFO - "sourcestamp": { 09:24:35 INFO - "repository": "", 09:24:35 INFO - "hasPatch": false, 09:24:35 INFO - "project": "", 09:24:35 INFO - "branch": "fx-team-macosx64-talos", 09:24:35 INFO - "changes": [ 09:24:35 INFO - { 09:24:35 INFO - "category": null, 09:24:35 INFO - "files": [ 09:24:35 INFO - { 09:24:35 INFO - "url": null, 09:24:35 INFO - "name": "https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 09:24:35 INFO - } 09:24:35 INFO - ], 09:24:35 INFO - "repository": "", 09:24:35 INFO - "rev": "94ec640656f15a9466debc0ea251de1b8d76fbc7", 09:24:35 INFO - "who": "cbook@mozilla.com", 09:24:35 INFO - "when": 1447261957, 09:24:35 INFO - "number": 6649227, 09:24:35 INFO - "comments": "Bug 1222291 - change getRuleText to handle token-less rules; r=bgrins", 09:24:35 INFO - "project": "", 09:24:35 INFO - "at": "Wed 11 Nov 2015 09:12:37", 09:24:35 INFO - "branch": "fx-team-macosx64-talos", 09:24:35 INFO - "revlink": "", 09:24:35 INFO - "properties": [ 09:24:35 INFO - [ 09:24:35 INFO - "buildid", 09:24:35 INFO - "20151111072432", 09:24:35 INFO - "Change" 09:24:35 INFO - ], 09:24:35 INFO - [ 09:24:35 INFO - "builduid", 09:24:35 INFO - "c70918fee84b43089c81ee020cb6fbe4", 09:24:35 INFO - "Change" 09:24:35 INFO - ], 09:24:35 INFO - [ 09:24:35 INFO - "pgo_build", 09:24:35 INFO - "False", 09:24:35 INFO - "Change" 09:24:35 INFO - ] 09:24:35 INFO - ], 09:24:35 INFO - "revision": "94ec640656f15a9466debc0ea251de1b8d76fbc7" 09:24:35 INFO - } 09:24:35 INFO - ], 09:24:35 INFO - "revision": "94ec640656f15a9466debc0ea251de1b8d76fbc7" 09:24:35 INFO - } 09:24:35 INFO - } 09:24:35 INFO - Found installer url https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 09:24:35 INFO - Running post-action listener: _resource_record_post_action 09:24:35 INFO - ##### 09:24:35 INFO - ##### Running download-and-extract step. 09:24:35 INFO - ##### 09:24:35 INFO - Running pre-action listener: _resource_record_pre_action 09:24:35 INFO - Running main action method: download_and_extract 09:24:35 INFO - mkdir: /builds/slave/test/build/tests 09:24:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:24:35 INFO - https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 09:24:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/test_packages.json 09:24:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/test_packages.json 09:24:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 09:24:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 09:24:36 INFO - Downloaded 1149 bytes. 09:24:36 INFO - Reading from file /builds/slave/test/build/test_packages.json 09:24:36 INFO - Using the following test package requirements: 09:24:36 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 09:24:36 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:24:36 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 09:24:36 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:24:36 INFO - u'jsshell-mac.zip'], 09:24:36 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:24:36 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 09:24:36 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 09:24:36 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:24:36 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 09:24:36 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:24:36 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 09:24:36 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:24:36 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 09:24:36 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 09:24:36 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:24:36 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 09:24:36 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 09:24:36 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')]} 09:24:36 INFO - https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 09:24:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:24:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:24:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/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 09:24:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/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 09:24:38 INFO - Downloaded 17454010 bytes. 09:24:38 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 09:24:38 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:24:38 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 09:24:43 INFO - Return code: 0 09:24:43 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 09:24:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:24:43 INFO - https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 09:24:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:24:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:24:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/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 09:24:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/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 09:24:44 INFO - Downloaded 17454010 bytes. 09:24:44 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 09:24:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:24:44 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 09:24:49 INFO - Return code: 0 09:24:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:24:49 INFO - https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 09:24:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 09:24:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 09:24:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/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 09:24:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/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 09:24:51 INFO - Downloaded 11131693 bytes. 09:24:51 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 09:24:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 09:24:51 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 09:24:51 INFO - Return code: 0 09:24: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')]} 09:24:51 INFO - https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 09:24:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 09:24:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 09:24:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 09:24:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pzQ1aMUvQNyUACkGYdRw0A/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 09:32:45 INFO - Downloaded 108708875 bytes. 09:32:45 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 09:32:45 INFO - mkdir: /builds/slave/test/properties 09:32:45 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:32:45 INFO - Writing to file /builds/slave/test/properties/build_url 09:32:45 INFO - Contents: 09:32:45 INFO - build_url:https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 09:32:45 INFO - Running post-action listener: _resource_record_post_action 09:32:45 INFO - Running post-action listener: set_extra_try_arguments 09:32:45 INFO - ##### 09:32:45 INFO - ##### Running populate-webroot step. 09:32:45 INFO - ##### 09:32:45 INFO - Running pre-action listener: _resource_record_pre_action 09:32:45 INFO - Running main action method: populate_webroot 09:32:45 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:32:45 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:32:45 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 09:32:45 INFO - '../fennec_ids.txt'], 09:32:45 INFO - 'tests': ['tcheck2']}, 09:32:45 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:32:45 INFO - '--tppagecycles', 09:32:45 INFO - '7'], 09:32:45 INFO - 'tests': ['tsvgm']}}, 09:32:45 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 09:32:45 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:32:45 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 09:32:45 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 09:32:45 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:45 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:32:45 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:45 INFO - 'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:32:45 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:45 INFO - 'tests': ['damp', 'tps']}, 09:32:45 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:45 INFO - 'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['damp', 'tps']}, 09:32:45 INFO - 'g3': {'tests': ['dromaeo_dom']}, 09:32:45 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:32:45 INFO - 'other': {'tests': ['a11yr', 09:32:45 INFO - 'ts_paint', 09:32:45 INFO - 'tpaint', 09:32:45 INFO - 'sessionrestore', 09:32:45 INFO - 'sessionrestore_no_auto_restore']}, 09:32:45 INFO - 'other-e10s': {'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['a11yr', 09:32:45 INFO - 'ts_paint', 09:32:45 INFO - 'tpaint', 09:32:45 INFO - 'sessionrestore', 09:32:45 INFO - 'sessionrestore_no_auto_restore']}, 09:32:45 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['a11yr', 09:32:45 INFO - 'ts_paint', 09:32:45 INFO - 'tpaint', 09:32:45 INFO - 'sessionrestore', 09:32:45 INFO - 'sessionrestore_no_auto_restore']}, 09:32:45 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['a11yr', 09:32:45 INFO - 'ts_paint', 09:32:45 INFO - 'tpaint', 09:32:45 INFO - 'sessionrestore', 09:32:45 INFO - 'sessionrestore_no_auto_restore']}, 09:32:45 INFO - 'other_l64': {'tests': ['a11yr', 09:32:45 INFO - 'ts_paint', 09:32:45 INFO - 'tpaint', 09:32:45 INFO - 'sessionrestore', 09:32:45 INFO - 'sessionrestore_no_auto_restore']}, 09:32:45 INFO - 'other_nol64': {'tests': ['a11yr', 09:32:45 INFO - 'ts_paint', 09:32:45 INFO - 'tpaint', 09:32:45 INFO - 'sessionrestore', 09:32:45 INFO - 'sessionrestore_no_auto_restore']}, 09:32:45 INFO - 'svgr': {'tests': ['tsvgx', 09:32:45 INFO - 'tsvgr_opacity', 09:32:45 INFO - 'tart', 09:32:45 INFO - 'tscrollx', 09:32:45 INFO - 'cart']}, 09:32:45 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['tsvgx', 09:32:45 INFO - 'tsvgr_opacity', 09:32:45 INFO - 'tart', 09:32:45 INFO - 'tscrollx', 09:32:45 INFO - 'cart']}, 09:32:45 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:45 INFO - 'tests': ['tp5o']}, 09:32:45 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:45 INFO - 'talos_options': ['--e10s'], 09:32:45 INFO - 'tests': ['tp5o']}, 09:32:45 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:45 INFO - 'talos_options': ['--xperf_path', 09:32:45 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:32:45 INFO - 'tests': ['tp5n']}, 09:32:45 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:45 INFO - 'talos_options': ['--e10s', 09:32:45 INFO - '--xperf_path', 09:32:45 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:32:45 INFO - 'tests': ['tp5n']}}, 09:32:45 INFO - 'talos.zip': {'path': '', 09:32:45 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:32:45 INFO - Running post-action listener: _resource_record_post_action 09:32:45 INFO - ##### 09:32:45 INFO - ##### Running create-virtualenv step. 09:32:45 INFO - ##### 09:32:45 INFO - Running pre-action listener: _resource_record_pre_action 09:32:45 INFO - Running main action method: create_virtualenv 09:32:45 INFO - Creating virtualenv /builds/slave/test/build/venv 09:32:45 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 09:32:45 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:32:45 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:32:45 INFO - Using real prefix '/tools/python27' 09:32:45 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:32:46 INFO - Installing distribute.............................................................................................................................................................................................done. 09:32:49 INFO - Installing pip.................done. 09:32:49 INFO - Return code: 0 09:32:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:32:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:32:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:32:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:49 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 0x10f03b490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f018228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe80e33360>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ef5e9f0>, '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 0x10ecbedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ef528c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/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.AQf6oxO7QV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 09:32:49 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 09:32:49 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 09:32:49 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/Render', 09:32:49 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:32:49 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:32:49 INFO - 'HOME': '/Users/cltbld', 09:32:49 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:32:49 INFO - 'LOGNAME': 'cltbld', 09:32:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:49 INFO - 'MOZ_NO_REMOTE': '1', 09:32:49 INFO - 'NO_EM_RESTART': '1', 09:32:49 INFO - 'PAGER': '/bin/cat', 09:32:49 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:32:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:49 INFO - 'PWD': '/builds/slave/test', 09:32:49 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:32:49 INFO - 'SHELL': '/bin/bash', 09:32:49 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AQf6oxO7QV/Listeners', 09:32:49 INFO - 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', 09:32:49 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:32:49 INFO - 'USER': 'cltbld', 09:32:49 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:32:49 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:32:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:49 INFO - 'XPC_FLAGS': '0x0', 09:32:49 INFO - 'XPC_SERVICE_NAME': '0', 09:32:49 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:32:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:50 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 09:32:50 INFO - Cleaning up... 09:32:50 INFO - Return code: 0 09:32:50 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 09:32: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')]} 09:32:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32: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')]} 09:32:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:50 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 0x10f03b490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f018228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe80e33360>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ef5e9f0>, '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 0x10ecbedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ef528c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/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.AQf6oxO7QV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 09:32:50 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 09:32:50 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 09:32:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/Render', 09:32:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:32:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:32:50 INFO - 'HOME': '/Users/cltbld', 09:32:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:32:50 INFO - 'LOGNAME': 'cltbld', 09:32:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:50 INFO - 'MOZ_NO_REMOTE': '1', 09:32:50 INFO - 'NO_EM_RESTART': '1', 09:32:50 INFO - 'PAGER': '/bin/cat', 09:32:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:32:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:50 INFO - 'PWD': '/builds/slave/test', 09:32:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:32:50 INFO - 'SHELL': '/bin/bash', 09:32:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AQf6oxO7QV/Listeners', 09:32:50 INFO - 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', 09:32:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:32:50 INFO - 'USER': 'cltbld', 09:32:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:32:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:32:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:50 INFO - 'XPC_FLAGS': '0x0', 09:32:50 INFO - 'XPC_SERVICE_NAME': '0', 09:32:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:32:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:50 INFO - Downloading/unpacking psutil>=0.7.1 09:32:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:32:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:32:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:53 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 09:32:53 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 09:32:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:32:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:32:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:32:53 INFO - Installing collected packages: psutil 09:32:53 INFO - Running setup.py install for psutil 09:32:53 INFO - building 'psutil._psutil_osx' extension 09:32:53 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 09:32:53 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 09:32:53 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 09:32:53 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 09:32:53 INFO - building 'psutil._psutil_posix' extension 09:32:53 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 09:32:53 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 09:32:53 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 09:32:53 INFO - ^ 09:32:54 INFO - 1 warning generated. 09:32:54 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 09:32:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:32:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:32:54 INFO - Successfully installed psutil 09:32:54 INFO - Cleaning up... 09:32:54 INFO - Return code: 0 09:32:54 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 09:32:54 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')]} 09:32:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:54 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')]} 09:32:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:54 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 0x10f03b490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f018228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe80e33360>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ef5e9f0>, '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 0x10ecbedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ef528c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/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.AQf6oxO7QV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 09:32:54 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 09:32:54 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 09:32:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/Render', 09:32:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:32:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:32:54 INFO - 'HOME': '/Users/cltbld', 09:32:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:32:54 INFO - 'LOGNAME': 'cltbld', 09:32:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:54 INFO - 'MOZ_NO_REMOTE': '1', 09:32:54 INFO - 'NO_EM_RESTART': '1', 09:32:54 INFO - 'PAGER': '/bin/cat', 09:32:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:32:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:54 INFO - 'PWD': '/builds/slave/test', 09:32:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:32:54 INFO - 'SHELL': '/bin/bash', 09:32:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AQf6oxO7QV/Listeners', 09:32:54 INFO - 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', 09:32:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:32:54 INFO - 'USER': 'cltbld', 09:32:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:32:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:32:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:54 INFO - 'XPC_FLAGS': '0x0', 09:32:54 INFO - 'XPC_SERVICE_NAME': '0', 09:32:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:32:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 09:32:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:32:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:32:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:56 INFO - Downloading mozsystemmonitor-0.0.tar.gz 09:32:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 09:32:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:32:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 09:32:56 INFO - Installing collected packages: mozsystemmonitor 09:32:56 INFO - Running setup.py install for mozsystemmonitor 09:32:57 INFO - Successfully installed mozsystemmonitor 09:32:57 INFO - Cleaning up... 09:32:57 INFO - Return code: 0 09:32:57 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:32:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:32:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:57 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 0x10f03b490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f018228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe80e33360>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ef5e9f0>, '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 0x10ecbedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ef528c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/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.AQf6oxO7QV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 09:32:57 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 09:32:57 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 09:32:57 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/Render', 09:32:57 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:32:57 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:32:57 INFO - 'HOME': '/Users/cltbld', 09:32:57 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:32:57 INFO - 'LOGNAME': 'cltbld', 09:32:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:57 INFO - 'MOZ_NO_REMOTE': '1', 09:32:57 INFO - 'NO_EM_RESTART': '1', 09:32:57 INFO - 'PAGER': '/bin/cat', 09:32:57 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:32:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:57 INFO - 'PWD': '/builds/slave/test', 09:32:57 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:32:57 INFO - 'SHELL': '/bin/bash', 09:32:57 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AQf6oxO7QV/Listeners', 09:32:57 INFO - 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', 09:32:57 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:32:57 INFO - 'USER': 'cltbld', 09:32:57 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:32:57 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:32:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:57 INFO - 'XPC_FLAGS': '0x0', 09:32:57 INFO - 'XPC_SERVICE_NAME': '0', 09:32:57 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:32:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:57 INFO - Downloading/unpacking blobuploader==1.2.4 09:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:32:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:32:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:32:59 INFO - Downloading blobuploader-1.2.4.tar.gz 09:32:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 09:32:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:32:59 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:32:59 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 09:32:59 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 09:32:59 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 09:32:59 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 09:32:59 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 09:32:59 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 09:33:00 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 09:33:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:33:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:33:00 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 09:33:00 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 09:33:00 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 09:33:00 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 09:33:00 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 09:33:00 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 09:33:00 INFO - Downloading docopt-0.6.1.tar.gz 09:33:00 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 09:33:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:33:01 INFO - Installing collected packages: blobuploader, requests, docopt 09:33:01 INFO - Running setup.py install for blobuploader 09:33:01 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:33:01 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:33:01 INFO - Running setup.py install for requests 09:33:01 INFO - Running setup.py install for docopt 09:33:01 INFO - Successfully installed blobuploader requests docopt 09:33:01 INFO - Cleaning up... 09:33:02 INFO - Return code: 0 09:33:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:33:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:33:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:33:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:02 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 0x10f03b490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f018228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe80e33360>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ef5e9f0>, '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 0x10ecbedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ef528c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/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.AQf6oxO7QV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 09:33:02 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 09:33:02 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 09:33:02 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/Render', 09:33:02 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:33:02 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:33:02 INFO - 'HOME': '/Users/cltbld', 09:33:02 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:33:02 INFO - 'LOGNAME': 'cltbld', 09:33:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:02 INFO - 'MOZ_NO_REMOTE': '1', 09:33:02 INFO - 'NO_EM_RESTART': '1', 09:33:02 INFO - 'PAGER': '/bin/cat', 09:33:02 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:33:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:02 INFO - 'PWD': '/builds/slave/test', 09:33:02 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:33:02 INFO - 'SHELL': '/bin/bash', 09:33:02 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AQf6oxO7QV/Listeners', 09:33:02 INFO - 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', 09:33:02 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:33:02 INFO - 'USER': 'cltbld', 09:33:02 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:33:02 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:33:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:02 INFO - 'XPC_FLAGS': '0x0', 09:33:02 INFO - 'XPC_SERVICE_NAME': '0', 09:33:02 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:33:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:33:02 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-oGNkmJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:33:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:33:02 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-QtczW2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:33:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:33:02 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-jWccFD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:33:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:33:02 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-tOqXIy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:33:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:33:02 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-sC_Chz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:33:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:33:02 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-jcGhAM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-C_ZiNK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-ZsOtPM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-oxdDRy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-ExYcT8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-j62TNG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-8xWqgX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-Kl3nmo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-sBWgkb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:33:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:33:03 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-b0gZu8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:33:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:33:04 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-Hk_geh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:33:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:33:04 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-zBuTgG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:33:04 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:33:04 INFO - Running setup.py install for manifestparser 09:33:04 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:33:04 INFO - Running setup.py install for mozcrash 09:33:04 INFO - Running setup.py install for mozdebug 09:33:04 INFO - Running setup.py install for mozdevice 09:33:05 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:33:05 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:33:05 INFO - Running setup.py install for mozfile 09:33:05 INFO - Running setup.py install for mozhttpd 09:33:05 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:33:05 INFO - Running setup.py install for mozinfo 09:33:05 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:33:05 INFO - Running setup.py install for mozInstall 09:33:05 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:33:05 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:33:05 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:33:05 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:33:05 INFO - Running setup.py install for mozleak 09:33:05 INFO - Running setup.py install for mozlog 09:33:06 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:33:06 INFO - Running setup.py install for moznetwork 09:33:06 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:33:06 INFO - Running setup.py install for mozprocess 09:33:06 INFO - Running setup.py install for mozprofile 09:33:06 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:33:06 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:33:06 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:33:06 INFO - Running setup.py install for mozrunner 09:33:07 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:33:07 INFO - Running setup.py install for mozscreenshot 09:33:07 INFO - Running setup.py install for moztest 09:33:07 INFO - Running setup.py install for mozversion 09:33:07 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:33:07 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:33:07 INFO - Cleaning up... 09:33:07 INFO - Return code: 0 09:33:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:33: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')]} 09:33:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33: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')]} 09:33:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33: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', '-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 0x10f03b490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f018228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe80e33360>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ef5e9f0>, '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 0x10ecbedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ef528c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/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.AQf6oxO7QV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 09:33:07 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 09:33:07 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 09:33:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/Render', 09:33:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:33:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:33:07 INFO - 'HOME': '/Users/cltbld', 09:33:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:33:07 INFO - 'LOGNAME': 'cltbld', 09:33:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:07 INFO - 'MOZ_NO_REMOTE': '1', 09:33:07 INFO - 'NO_EM_RESTART': '1', 09:33:07 INFO - 'PAGER': '/bin/cat', 09:33:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:33:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:07 INFO - 'PWD': '/builds/slave/test', 09:33:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:33:07 INFO - 'SHELL': '/bin/bash', 09:33:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AQf6oxO7QV/Listeners', 09:33:07 INFO - 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', 09:33:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:33:07 INFO - 'USER': 'cltbld', 09:33:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:33:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:33:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:07 INFO - 'XPC_FLAGS': '0x0', 09:33:07 INFO - 'XPC_SERVICE_NAME': '0', 09:33:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:33:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-vfKhdn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:33:08 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)) 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-F2Dcd1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:33:08 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)) 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-LoJhyR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:33:08 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)) 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-qleDAe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:33:08 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)) 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-LsN9Fe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:33:08 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)) 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-bRdKtQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:33:08 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)) 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-xbUgSL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:33:08 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)) 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-w1C5eE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:33:08 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)) 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:33:08 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-_kTO75-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:33:09 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)) 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:33:09 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-jcCSSK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:33:09 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)) 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:33:09 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-RKbzj6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:33:09 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)) 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:33:09 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-tigzED-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:33:09 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)) 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:33:09 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-k95Xrj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:33:09 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)) 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:33:09 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-ia5xBH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:33:09 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)) 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:33:09 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-2zBsVL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:33:09 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)) 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:33:09 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-KTv5Bq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:33:09 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)) 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:33:09 INFO - Running setup.py (path:/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/pip-DCuDqn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:33:10 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)) 09:33:10 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)) 09:33:10 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)) 09:33:10 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)) 09:33:10 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)) 09:33:10 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)) 09:33:10 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:33:10 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 09:33:10 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 09:33:10 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 09:33:10 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 09:33:10 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 09:33:10 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 09:33:12 INFO - Downloading blessings-1.5.1.tar.gz 09:33:12 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 09:33:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:33:12 INFO - Installing collected packages: blessings 09:33:12 INFO - Running setup.py install for blessings 09:33:12 INFO - Successfully installed blessings 09:33:12 INFO - Cleaning up... 09:33:12 INFO - Return code: 0 09:33:12 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:33:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:33:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:33:13 INFO - Reading from file tmpfile_stdout 09:33:13 INFO - Current package versions: 09:33:13 INFO - blessings == 1.5.1 09:33:13 INFO - blobuploader == 1.2.4 09:33:13 INFO - docopt == 0.6.1 09:33:13 INFO - manifestparser == 1.1 09:33:13 INFO - mozInstall == 1.12 09:33:13 INFO - mozcrash == 0.16 09:33:13 INFO - mozdebug == 0.1 09:33:13 INFO - mozdevice == 0.47 09:33:13 INFO - mozfile == 1.2 09:33:13 INFO - mozhttpd == 0.7 09:33:13 INFO - mozinfo == 0.9 09:33:13 INFO - mozleak == 0.1 09:33:13 INFO - mozlog == 3.0 09:33:13 INFO - moznetwork == 0.27 09:33:13 INFO - mozprocess == 0.22 09:33:13 INFO - mozprofile == 0.27 09:33:13 INFO - mozrunner == 6.11 09:33:13 INFO - mozscreenshot == 0.1 09:33:13 INFO - mozsystemmonitor == 0.0 09:33:13 INFO - moztest == 0.7 09:33:13 INFO - mozversion == 1.4 09:33:13 INFO - psutil == 3.1.1 09:33:13 INFO - requests == 1.2.3 09:33:13 INFO - wsgiref == 0.1.2 09:33:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:33:13 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')]} 09:33:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:13 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')]} 09:33:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:13 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 0x10f03b490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f018228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe80e33360>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ef5e9f0>, '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 0x10ecbedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ef528c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/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.AQf6oxO7QV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 09:33:13 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 09:33:13 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 09:33:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/Render', 09:33:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:33:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:33:13 INFO - 'HOME': '/Users/cltbld', 09:33:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:33:13 INFO - 'LOGNAME': 'cltbld', 09:33:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:13 INFO - 'MOZ_NO_REMOTE': '1', 09:33:13 INFO - 'NO_EM_RESTART': '1', 09:33:13 INFO - 'PAGER': '/bin/cat', 09:33:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:33:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:13 INFO - 'PWD': '/builds/slave/test', 09:33:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:33:13 INFO - 'SHELL': '/bin/bash', 09:33:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AQf6oxO7QV/Listeners', 09:33:13 INFO - 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', 09:33:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:33:13 INFO - 'USER': 'cltbld', 09:33:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:33:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:33:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:13 INFO - 'XPC_FLAGS': '0x0', 09:33:13 INFO - 'XPC_SERVICE_NAME': '0', 09:33:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:33:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 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)) 09:33:13 INFO - Cleaning up... 09:33:13 INFO - Return code: 0 09:33:13 INFO - Running post-action listener: _resource_record_post_action 09:33:13 INFO - Running post-action listener: _start_resource_monitoring 09:33:13 INFO - Starting resource monitoring. 09:33:13 INFO - ##### 09:33:13 INFO - ##### Running install step. 09:33:13 INFO - ##### 09:33:13 INFO - Running pre-action listener: _resource_record_pre_action 09:33:13 INFO - Running main action method: install 09:33:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:33:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:33:13 INFO - Reading from file tmpfile_stdout 09:33:13 INFO - Detecting whether we're running mozinstall >=1.0... 09:33:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:33:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:33:13 INFO - Reading from file tmpfile_stdout 09:33:13 INFO - Output received: 09:33:13 INFO - Usage: mozinstall [options] installer 09:33:13 INFO - Options: 09:33:13 INFO - -h, --help show this help message and exit 09:33:13 INFO - -d DEST, --destination=DEST 09:33:13 INFO - Directory to install application into. [default: 09:33:13 INFO - "/builds/slave/test"] 09:33:13 INFO - --app=APP Application being installed. [default: firefox] 09:33:13 INFO - mkdir: /builds/slave/test/build/application 09:33:13 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'] 09:33:13 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 09:33:51 INFO - Reading from file tmpfile_stdout 09:33:51 INFO - Output received: 09:33:51 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 09:33:51 INFO - Running post-action listener: _resource_record_post_action 09:33:51 INFO - ##### 09:33:51 INFO - ##### Running run-tests step. 09:33:51 INFO - ##### 09:33:51 INFO - Running pre-action listener: _resource_record_pre_action 09:33:51 INFO - Running main action method: run_tests 09:33:51 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 09:33:51 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 09:33:51 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 09:33:51 INFO - 2015-11-11 09:33:51.314 screenresolution[2004:15712] starting screenresolution argv=screenresolution get 09:33:51 INFO - 2015-11-11 09:33:51.317 screenresolution[2004:15712] Display 0: 1600x1200x32@60 09:33:51 INFO - 2015-11-11 09:33:51.324 screenresolution[2005:15714] starting screenresolution argv=screenresolution list 09:33:51 INFO - Available Modes on Display 0 09:33:51 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 09:33:51 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 09:33:51 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 09:33:51 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 09:33:51 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 09:33:51 INFO - Intel HD Graphics 3000: 09:33:51 INFO - Chipset Model: Intel HD Graphics 3000 09:33:51 INFO - Type: GPU 09:33:51 INFO - Bus: Built-In 09:33:51 INFO - VRAM (Total): 512 MB 09:33:51 INFO - VRAM (Dynamic, Max): 10 09:33:51 INFO - Vendor: Intel (0x8086) 09:33:51 INFO - Device ID: 0x0116 09:33:51 INFO - Revision ID: 0x0009 09:33:51 INFO - Displays: 09:33:51 INFO - Display: 09:33:51 INFO - Resolution: 1600 x 1200 @ 60 Hz 09:33:51 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 09:33:51 INFO - Display Serial Number: 1600x1200 60 09:33:51 INFO - Main Display: Yes 09:33:51 INFO - Mirror: Off 09:33:51 INFO - Online: Yes 09:33:51 INFO - Rotation: Supported 09:33:51 INFO - Return code: 0 09:33:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:33:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:33:51 INFO - Python 2.7.3 09:33:51 INFO - Return code: 0 09:33:51 INFO - grabbing minidump binary from tooltool 09:33: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')]} 09:33:51 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 0x10ef5e9f0>, '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 0x10ecbedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ef528c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:33:51 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 09:33:51 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 09:33:51 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:33:51 INFO - Return code: 0 09:33:51 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 09:33:51 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:33:51 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:33:51 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 09:33:51 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:33:51 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', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0010', '--webServer', 'localhost'] in /builds/slave/test/build 09:33:51 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 --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0010 --webServer localhost 09:33:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4YUf7TilnE/Render', 09:33:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:33:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:33:51 INFO - 'HOME': '/Users/cltbld', 09:33:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:33:51 INFO - 'LOGNAME': 'cltbld', 09:33:51 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:33:51 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 09:33:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:51 INFO - 'MOZ_NO_REMOTE': '1', 09:33:51 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:33:51 INFO - 'NO_EM_RESTART': '1', 09:33:51 INFO - 'PAGER': '/bin/cat', 09:33:51 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:33:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:51 INFO - 'PWD': '/builds/slave/test', 09:33:51 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:33:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:33:51 INFO - 'SHELL': '/bin/bash', 09:33:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AQf6oxO7QV/Listeners', 09:33:51 INFO - 'TMPDIR': '/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/', 09:33:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:33:51 INFO - 'USER': 'cltbld', 09:33:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:33:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:33:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:51 INFO - 'XPC_FLAGS': '0x0', 09:33:51 INFO - 'XPC_SERVICE_NAME': '0', 09:33:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:33:51 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', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0010', '--webServer', 'localhost'] with output_timeout 3600 09:33:51 INFO - mozversion INFO | application_buildid: 20151111072432 09:33:51 INFO - mozversion INFO | application_changeset: 94ec640656f15a9466debc0ea251de1b8d76fbc7 09:33:51 INFO - mozversion INFO | application_display_name: Nightly 09:33:51 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:33:51 INFO - mozversion INFO | application_name: Firefox 09:33:51 INFO - mozversion INFO | application_remotingname: firefox 09:33:51 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 09:33:51 INFO - mozversion INFO | application_vendor: Mozilla 09:33:51 INFO - mozversion INFO | application_version: 45.0a1 09:33:51 INFO - mozversion INFO | platform_buildid: 20151111072432 09:33:51 INFO - mozversion INFO | platform_changeset: 94ec640656f15a9466debc0ea251de1b8d76fbc7 09:33:51 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 09:33:51 INFO - mozversion INFO | platform_version: 45.0a1 09:33:51 INFO - 2015-11-11 09:33:51,937 DEBUG : using testdate: 1447263231 09:33:51 INFO - 2015-11-11 09:33:51,937 DEBUG : actual date: 1447263231 09:33:51 INFO - 2015-11-11 09:33:51,948 INFO : starting webserver on 'localhost:50132' 09:33:51 INFO - 2015-11-11 09:33:51,949 INFO : Starting test suite t-yosemite-r5-0010 09:33:51 INFO - 2015-11-11 09:33:51,949 INFO : Starting test dromaeo_css 09:33:51 INFO - 2015-11-11 09:33:51,949 DEBUG : operating with platform_type : mac_ 09:33:51 INFO - 2015-11-11 09:33:51,950 INFO : Initialising browser for dromaeo_css test... 09:33:51 INFO - 2015-11-11 09:33:51,963 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/tmpWtuSbJ/profile http://localhost:50132/getInfo.html 09:33:54 INFO - 2015-11-11 09:33:54,730 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:33:54 INFO - 2015-11-11 09:33:54,730 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:33:54 INFO - 2015-11-11 09:33:54,731 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 09:33:54 INFO - 2015-11-11 09:33:54,731 DEBUG : BROWSER_OUTPUT: __metrics 09:33:54 INFO - 2015-11-11 09:33:54,746 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:33:55 INFO - 2015-11-11 09:33:55,470 INFO : Browser initialized. 09:33:55 INFO - 2015-11-11 09:33:55,471 INFO : Running cycle 1/1 for dromaeo_css test... 09:33:55 INFO - 2015-11-11 09:33:55,471 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/tmpWtuSbJ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:34:07 INFO - 2015-11-11 09:34:07,616 DEBUG : BROWSER_OUTPUT: RSS: Main: 229679104 09:34:07 INFO - 2015-11-11 09:34:07,616 DEBUG : BROWSER_OUTPUT: 09:34:58 INFO - 2015-11-11 09:34:58,747 DEBUG : BROWSER_OUTPUT: 1447263298746 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] 09:37:10 INFO - 2015-11-11 09:37:10,425 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50132/tests/dromaeo/cssquery-ext.html) 09:37:11 INFO - 2015-11-11 09:37:11,660 DEBUG : BROWSER_OUTPUT: RSS: Main: 343080960 09:37:11 INFO - 2015-11-11 09:37:11,660 DEBUG : BROWSER_OUTPUT: 09:40:14 INFO - 2015-11-11 09:40:14,367 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/dromaeo/cssquery-ext.html (next: http://localhost:50132/tests/dromaeo/cssquery-jquery.html) 09:40:14 INFO - 2015-11-11 09:40:14,948 DEBUG : BROWSER_OUTPUT: RSS: Main: 366305280 09:40:14 INFO - 2015-11-11 09:40:14,949 DEBUG : BROWSER_OUTPUT: 09:43:17 INFO - 2015-11-11 09:43:17,058 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50132/tests/dromaeo/cssquery-mootools.html) 09:43:17 INFO - 2015-11-11 09:43:17,638 DEBUG : BROWSER_OUTPUT: RSS: Main: 323588096 09:43:17 INFO - 2015-11-11 09:43:17,638 DEBUG : BROWSER_OUTPUT: 09:46:19 INFO - 2015-11-11 09:46:19,703 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50132/tests/dromaeo/cssquery-prototype.html) 09:46:20 INFO - 2015-11-11 09:46:20,308 DEBUG : BROWSER_OUTPUT: RSS: Main: 319889408 09:46:20 INFO - 2015-11-11 09:46:20,308 DEBUG : BROWSER_OUTPUT: 09:49:23 INFO - 2015-11-11 09:49:23,464 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50132/tests/dromaeo/cssquery-yui.html) 09:49:24 INFO - 2015-11-11 09:49:24,050 DEBUG : BROWSER_OUTPUT: RSS: Main: 319938560 09:49:24 INFO - 2015-11-11 09:49:24,050 DEBUG : BROWSER_OUTPUT: 09:52:26 INFO - 2015-11-11 09:52:26,914 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/dromaeo/cssquery-yui.html (next: http://localhost:50132/tests/dromaeo/cssquery-dojo.html) 09:52:27 INFO - 2015-11-11 09:52:27,176 DEBUG : BROWSER_OUTPUT: RSS: Main: 363134976 09:52:27 INFO - 2015-11-11 09:52:27,176 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,176 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:52:27 INFO - 2015-11-11 09:52:27,176 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:52:27 INFO - 2015-11-11 09:52:27,176 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:52:27 INFO - 2015-11-11 09:52:27,177 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:52:27 INFO - 2015-11-11 09:52:27,177 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3181.1569933967494;3235.4014507316165;3273.4435146025176;3277.1315601365627;3296.110050286422;5232.816851410202;5284;5303.23103150043;5441.755121019553;5457.372402173752;5170.327857378536;5235.162374020158;5297.417284098756;5415.241866138734;5477.780888764454;4748.667593268473;4890.119778439879;4937.580305674022;4947.703137811724;5031.924521132168;4605.194091034073;5041.0422019816115;5041.546260836524;5054.5193114191015;5137.717425541594;4717.174494463455;4924.532169443933;4938.135826230413;4954.355933728628;4971.701697898102;4837.927431088537;4925.433575138869;4930.408350997904;4939.876503087416;4985.800567977313;4892.633052521075;4913.533214344631;4916.557509824097;4923.335349727777;4953.752312384367;5045.798168073273;5122.795088196468;5192.402873669538;5195.636305458619;5376.623636345457;5608.915866262009;5636.464535869127;5690.516306113986;5700.828975130711;5705.6291341063115;5670.432956704338;5675.574331925122;5708.828735137952;5740.913886291709;5748.396418376094;5185.507376799198;5226.477352264743;5244.580433565306;5258.579313654898;5285.68285902847;5747.8563035924435;5803.593748437569;5812.38969908162;5818.4763371296785;5840.415958404211;5516.089845175581;5525.419830917695;5572.693501857437;5578.442155784389;5644.915326270109;5643.322801263875;5684.232628595087;5724.79963201286;5762.1068734346245;5765.88468230633;5643.689597072201;5691.402402747734;5703.08750599902;5745.6552606843725;5830.82507524775;5598.412166722517;5647.37878833328;5674.148877668383;5697.287839020122;5706.029974904276;4274.273373526508;4404.229259879508;4410.29435290352;4476.485204201494;4515.75163366018;3939.7242193046213;3973.264945985002;4001.299772539794;4027.1945610877356;4061.5126184858004;5387.542058925035;5426.213199086111;5426.62013659048;5431.34823821144;5431.646942948696;5593.608447408724;5714.771409143587;5743.109817978137;5792.623479473821;5827.4172582741385;5250.842474725764;5303.5757139429525;5324.946750532445;5327.0145023170835;5338.91991620126;5063.620228482879;5077.593792496591;5079.695218286841;5090.745462726849;5103;5711.714414279187;5844.47399734026;5912.852178695567;5919.733611987384;5921.052631579013;5669.54643628517;5694.743736531783;5734.741936612779;5747.453991870766;5814.592978491634;5877.118432235199;5938.643681378958;5942.584019118794;5944.405559444194;5952.791652292149;5313.760880760297;5373.570114390761;5660.29246344207;5676.460736230051;5729.3124825019595;5453.563714902878;5609.719514024364;5624.887502250014;5668.206451096932;5678.630888992202;5573.108302671553;5631.2960879890015;5668.319801623831;5670.319561652463;5674.914876276942;5390.784368625368;5493.148561972901;5583.497485226349;5638.436156384329;5656.632318899258;5357.383900851452;5427.592930530305;5436.565074794086;5455.5908306876345;5573.526250268773;5606.215129881738;5612.943870561242;5626.35296940857;5648.519875810603;5688.203651488712;5416.783328666809;5502.889942201214;5519.972400137974;5524.171374293727;5532.114861622121 09:52:27 INFO - 2015-11-11 09:52:27,177 DEBUG : BROWSER_OUTPUT: |1;ext.html;531.2456312036904;546.9917951230734;547.6084599511349;552.1607157121175;565.0535353283252;28577.14268571941;29308.706912930866;38548.421773673384;39629.60370396295;39885;40427.19145617086;41208.793956030255;41361;41466;41494.7925260374;8855.380123391365;9050.140236677538;9053.547322633875;9085.591148398338;9129.863052054225;8697.608607612672;8822.073682263333;8844.690435834747;8881.73354799357;8913.286937045053;8823.60293786778;8828.690995815148;8840.204381605654;8902.198802107809;8960.641574337018;8685.261752751023;8757.386982911199;8856.158664926821;8856.335774816915;8899.466032038034;8594.140585941419;8715.346349023848;8726.52004139772;8739.213470787596;8766.912330876674;37623.435648465296;38005;38025.23949520994;38068;38458.23083538313;2885;2918.4892643787252;2930.106317573139;2987.14866263114;3236.417444859948;26310.342241443926;26535.73464265352;27737.58393624097;28322.15033548976;29792.553111703342;2125.4686328417897;2132.051237199447;2182.5962196993605;2195.4950361416804;2198.483356411242;261031;263113;264191;266838;270551;54837.725811371485;56170;59781.40218597758;59919.400805992256;60094.69952650209;61078.38921610727;61885.38114618886;62709.37290627036;62875.68562157251;62933.37066629275;15086.698266034618;15179.316930738143;15186.924065379824;15194.392224310905;15332.923335383251;11055.120629493005;11288.492017859217;11528.365939873387;12011.63965081049;12249.448774805156;19633.901830490755;19638.70541941872;19700.408987730392;19816;19877.204911803656;8528;8686.218240358397;8701.608427620773;8733.825323493495;8816.426932249511;832.8459235041537;923.5290002098978;951.5194826612517;1035.2390992620417;1037.7768779712399;26179;26755.46489070208;27044.484217051657;27265.86367068152;27314.31714207121;1050.616524968381;1063.3885515828274;1125.7129431994952;1159.5361855257963;1166.102101381931;14042.719145617031;14093.487925383906;14098.788518172236;14188;14299.499517516837;365037;368459;370867;377712;380051;54233.457665422844;54756;54786;54893.451065488836;54967;1229.3730197599289;1246.3269834289563;1363.9795403068963;1389.9374528146257;1398.5594537720585;28038.579421308288;28075.438491229652;28082;28328.716712832607;28465;44159.33760993652;44981;45184;45518.77240613776;45571;247443;255736;274689;277656;279941;29275.7072429273;29482.852585736935;29568.408631827675;29745.405091898472;30190.245243869078;37365.626343737305;38221.42667859929;38273;38735.22529549449;38775.22449550937;31311.686883131788;34525.82737086399;34707;35021.82489087538;35070.47394289036;34600.307993840484;34876.302473950884;35300;35347.293054139285;37475;35218;35316.11522732446;35661.28677426489;37842;38142.42786358263;29405.55891661584;30626.387472250877;30718.078457646305;30827.845860770554;30878.53682194814;23238.167315601506;23259.651105233097;23371.08514985033;23472;23565.528689426457 09:52:27 INFO - 2015-11-11 09:52:27,177 DEBUG : BROWSER_OUTPUT: |2;jquery.html;326.10484220813856;329.1425835698008;331.74455669134767;336.8265343348176;337.5544281548356;13954.30228488574;14494.710105797878;16537.17314134293;16707;17456;13217.07480476367;13892.583222503315;17039.403620873272;17465.388711395102;17547.824521754777;5201.349831271091;5339.439358867321;5340.198970154469;5342.652727572696;5354.678719276856;3769.9811500942455;5151.098557752397;5274.5780337572905;5319.840404787863;5382.1119515280125;3881.146147847469;5622.662640241599;5772.278465191851;5786.56600754943;5801.47786699197;5712.942870571283;5738;5770.509506691915;5823.767049318022;5826.359100498942;4993.400791904958;4997.450280469146;5029.773660185264;5032.723200223986;5047.192449208109;21115.788842111535;21137.894310528503;21138;21186.258480953245;21442.24952126668;1894.8768330058501;1899.325739362534;1948.4933917181493;1958.3831093205595;1960.7941166177632;13097.607071787861;13290;13370.866291337059;13409.86590134096;13458.394372253271;1606.092557704893;1629.2098332308822;1642.8439298266646;1667.2330727865196;1667.4054115971305;53552;55331;55888.44111558873;56131;56738.43261567414;9143.588538515784;9374.90625093754;9543.236541076698;9608.087231712976;9653.90346096544;11671.35807530594;11679.532818687327;11761.647150585497;11798.056155507711;11798.233114847679;7307.963460182665;7687.385009199251;7692.884606730903;7754.3796496280165;7761.6119194040075;7811.80470488231;7830;7836.882446763303;7879.290863822283;7901.17037711032;5653.519450846642;5746.913796293059;5763.193152958589;5763.8559036024435;5811.128330750421;1508;1580.2256894122027;1624.6750649870073;1640.4586486459439;1659.1787065402702;844.3456321351002;908.7001289574424;920.4799288402031;1015.0914931136591;1072.7961687279392;10820.56717731282;11339.433028348549;11347.829782553268;11349.09207263417;11443.427828608535;401.27970293323557;410.386472224021;415.15723082143296;433.1315711997488;439.52970321756055;5837.211976383219;5933;5944.4352786485215;6089.543284253698;6174.536909731788;495242;500214;506903;510700;513906;66577;68858;69150.30849691539;69743.3025669747;69745;463.9466461356987;472.1430603454787;473.6471328860021;474.4733345986022;479.2093046473277;10265.178785697275;10377.273590848568;10399;10454.163666906781;10548.472576371305;33291.334173316885;33758;34306.31387372188;34456.31087378289;34977.65022349744;42925.78537107295;43845.561544385426;44363;46797.766011169726;50265.74867125641;5730.111832665943;6019.87960240784;6021.126936594257;6034.185384973148;6051.183090282755;11111.944440277746;11208.71978200519;11434.313941163557;11653.067754579783;11662.241954272946;9675.516224188903;9692.951535242279;9950.303478756707;9985.1512621428;10092.646757363456;9185.632574696938;9462.763430914007;9547.952260238655;9577;9818.509074546388;8098.7165449209;9041.547922603975;9485.952570237105;9641.60294886808;9852.852207216754;5882.882342353215;5921.970390148022;5968.4926781224085;5986.9401305986385;5994.220751302303;9248.861267080865;9743.366681165702;9812.067853553901;9895.455749933823;10028.498575071071 09:52:27 INFO - 2015-11-11 09:52:27,177 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1399.6990647010891;1451.1800832529627;1582.16936108543;1608.4290077022656;1794.8025717171117;6902.344277293661;7513.812154696136;7522.247775222475;7550.509216900905;7558.244175582439;7614.61926903654;7786.702922637821;7808.453408261424;7846.176151504082;7876.094249161348;1852.6479968805952;1908.2748555548942;2087.269455690511;2187.8249740020838;2213.756486786452;2173.1307477009245;2173.7500187478404;2179.7384313882276;2184.0390228299575;2191.934241972743;2097.402240361497;2183.4868805830697;2185.8907054647284;2187.453136715821;2188.671699245118;1864.4965859218003;1898.07943147574;2148.763636000039;2186.6173419651495;2228.888555572215;2153.9784602153936;2173.7717539658424;2202.9779702203095;2204.559088182354;2219.1789038055863;7585.317321441097;7622.313991740714;7665.195154508752;7729.033870766154;7736.961315193388;4609.539046095397;4697.67116301859;4704.976475117637;4731.503192164842;4759.238521836524;2692.273086266697;2708.498927698382;2747.148384000966;2753.160286112755;2834.135588645462;803.9276465118108;807.9757607271791;827.6275675945849;848.5587494502824;851.3997631669658;10193.796124077551;10290.897091029143;10312.329698569643;10396.896031039669;10398.116160126323;4118;4149.543550209474;4259.701820872509;4264.019275566637;4331.480222373335;9159.358844880795;9174.311926605531;9175.678851240174;9196.770080747901;9277.443353398683;4751.311059896296;4780.49804770501;4780.808767649325;4789.425268967746;4842.346283251786;4355.607995280377;4357.9782101089295;4366.061296821199;4367.672424568106;4397.428334316518;3436.244026314207;3499.4400895856543;3510.14001569612;3511.9122021949142;3534.929301414009;1143.891330323618;1162.8430161928031;1172.5778719660916;1179.1038810504078;1189.1616410430627;906.8141031088611;1243.6766440725296;1247.0647014738945;1260.8550016748009;1267.6007057776771;6617.735290588323;7163.8567228656175;7293.1248250209255;7312.268773122645;7327.780166594904;624.5784095735361;625.7841044839614;637.977610973216;643.8454770854961;650.5673726971605;5541.833744987657;5642.746076426571;5685.772569097273;5696.458836410535;5706.343770466449;9046.683366082156;9062.864057039149;9264.861027084598;9270.119338662817;9276.211522020703;8977.10228977097;9098.636054557743;9134.223590994707;9140.085991400807;9155.038720934339;7222.458315626349;7226.458015648847;7228.024216730674;7242.6378681065735;7293.598852063187;6964.512484126062;7007.089078419773;7024.26245244242;7056.788296351117;7056.858862822817;7835.529868207926;8172.6730930762105;8184.508929464251;8184.631691573774;8223.465474744122;8287.295579875778;8296.585170741559;8331.458455200393;8453.957730211556;8459.154084591737;6798.252192258748;6838.487113466411;6840.0765896603325;6842.315768423118;6842.55523390978;7293.234210407831;7351.705931762884;7360.484766066324;7379;7570.470067095251;6867.450603951572;6892.207396149306;6922.688479018356;7073.752418665322;7102.573845569283;6751.864962700817;6841.863162736618;6903.723851045902;6949.930500694928;6955.304469553004;5900.940990590039;6044.697765111815;7021.613811240431;7046.506744528039;7083.787486375417;5943.7028148591535;6165.167702360303;6188.907166392418;6206.10011548332;6286;6392.9360706392345;6434.613923164625;6445.5165862561435;6499.025146228104;6524.151860258136 09:52:27 INFO - 2015-11-11 09:52:27,177 DEBUG : BROWSER_OUTPUT: |4;prototype.html;309.85901414856244;314.5549048096943;316.9508726147447;318.91548739584016;322.0772486825246;5793.594448388614;5819.912701309484;5854.531637469003;5856.882862342751;5908.645481271126;5821.243238379016;5852.531797456204;5868.471837534621;5899.616524925877;5988;4541.795619197144;4541.863744087666;4547.5907168354925;4566.086782643468;4600.97699511502;4389.056352884129;4486.327050942352;4506.77466126694;4574.519675434081;4592.402987611623;4479.865604031868;4500.774961251941;4507.639388848901;4525.909481810362;4539.160255352754;4498.8875278117985;4511.842085527007;4514;4529.00361920377;4543.613792827614;3934.8426062957446;3935.9803200984097;3940.4089386591954;3943.191645712622;3951.8024098794945;5637.746301416405;5708.343540492855;5737.168110623936;5779.422057794229;5779.682117483537;5023.924641130349;5066.392032956069;5072.695638261716;5074.873128171826;5090.796368145269;5987.760489580412;6178.320384757673;6191.195144631214;6212.968935155341;6213.533984951102;4096.160287141129;4112.424260603518;4158.750474971512;4159.688023398257;4167.312393455076;6391;6450.096986421905;6457.903131453032;6489.772857949996;6502.707378167994;4188.308929026737;4195.098053918361;4201.97899010503;4219.43037689914;4224.76763777989;4149.564295748964;4212.641925436372;4241.321388577812;4262.488501379854;4264.6801489888385;5017.67385119966;5039.97480012605;5073.315102461194;5083;5084.51697088776;6248.4376406123665;6265.780697675559;6269.65516896566;6271.435570798559;6300.243970723543;1539.4996626096563;1558.3766493402502;1560.960975975587;1566.506550436609;1567.968640627204;993.6025589764153;993.7515621094726;1003.1373019203479;1009.6516701737888;1013.366645846346;6012.518998480111;6035.728392222272;6041.395860414012;6046.093086037042;6049.425304596057;6453.870922581522;6490.091387205795;6494.1232933553365;6516.446102081376;6555.967220163964;5988.850278743066;6017.638941663514;6034.366391528914;6039.365866583946;6056.182415373956;3537.911552211215;3564.518789963322;3580.230250496156;3593.4969104325414;3605.0987253186704;6621.933780662228;6624.6025238485845;6632.9336706633285;6656.866862662817;6658.234303055114;6491.091247225392;6583.63789991555;6607.735690572324;6639.933600663931;6641;6397.840053998687;6605.1083103780375;6626.237982631963;6653.9667301663185;6798;6162.291336496361;6534.183227096613;6537.607743535403;6540.215174179129;6543.509236807354;6238.469730072813;6274.058891166362;6278.811635650938;6281.371862813682;6372.904406433814;6628.370304821035;6629.569078009914;6637.900431493628;6638.5684930479365;6702.731890724316;4093.4678491795876;4149.315362965077;4171.624553790173;4211.0946146578635;4245.702800804038;6405.03924411342;6409.583377080475;6415.326390729093;6419.454346380423;6420.357964203542;6214.067889816563;6229.034499652561;6235.220597425322;6247.812565623039;6249.093881387264;6021.397860213943;6190.2571691397325;6195.659238741912;6195.81412557624;6200.844978875564;6092.086187071975;6119.2350956130485;6164.414380634012;6178.907316390168;6179.938200617937;6274.466670333073;6279.215098112736;6295.527835412454;6323.620582765049;6323.747050118128;5972.313183983897;6165.321814600301;6173.938260617516;6201.534884883562;6219.036049412348 09:52:27 INFO - 2015-11-11 09:52:27,179 DEBUG : BROWSER_OUTPUT: |5;yui.html;632.0613888375761;632.2507828223555;699.5487910297854;700.2402393403158;743.5798773692865;13265.40305686244;13414.798778018325;13534.661633459169;13542.052056356059;13703.451861925523;12702.174358666703;12773.744525109516;12816.359182040907;12960.287184204864;12962.74074518509;679.9184097908234;686.4954258619911;862.6247582301687;876.6055275126187;883.002207505521;817.480899628734;861.7845538615346;867.6659486097834;879.9880137841469;880.2297989259398;898.3172788680617;898.5192921786845;903.0202230579796;903.0878812399491;905.42053086025;707.5613119865691;718.8598223346476;869.9347548933855;884.9955750221272;896.6010125494158;651.9250286217051;654.1202083198091;654.6922946215271;655.8950567909112;656.6454114778014;13136.080474366798;13144.211347319097;13155.40800663963;13279.668008299774;13362.398692058881;10421.166306695523;11235.438228088562;11434;11446.370449625267;11503.827442588368;8705.434146780502;8787.384883058188;9045.32160087996;9225.16973472384;9363.812723745486;3099.5815564898676;3152.0701393089093;3211.3095684427726;3354.815485148316;3374.9875037488655;48130.03739925217;48289.5171048292;48364.516354836705;48523.5147648526;48591.75704121492;8440.366972476966;8887.644494220158;8901.243394311427;9068.229200517899;9120.58957346921;18744.906275468536;18752.62494750097;18772;18786.624267514846;18796.248150074116;6573.539852210395;6675.465962723068;6692.665366731644;6720.731170753115;6985.79042628722;3380.2056516718553;3486.6164721880573;3520.2431477232517;3564.3584154852374;3577.409727395003;2698.082651898364;2853.5576985567272;2922.415516896629;2927.1657577590286;2930.5164647832867;448.75094322651245;456.0354849493364;457.3345781887346;460.44286413440113;462.7408651155364;472.39533397251574;495.86611614863784;524.6065450911816;527.8785879247718;595.4254144750337;6914.896276555855;6962.408195303456;6993.440524758109;7105.4506679422475;7132.322429369202;457.1816448557112;503.6449303241206;551.242042191986;553.4299671338528;560.7084316155576;3403.982980085084;3678.7240956928335;3833.600735731494;3858.459815625815;3928.941065884014;54095.45904540904;55526;57699;58568.414315857146;58876.7056164725;45093.54906450959;47284.29073563899;47408.76295618569;47426.76286618545;47500.28749568759;43180.568194318286;43885;48934.510654893;49016;49115.508844911805;7507.812304692427;7661.770146895602;7781.416393770377;8037.23646253605;8116.066652335057;33160;33546.329073418885;33721.32557348888;34551;36162;43874.561254387045;46159.76920115378;46243.3063504041;46958.530414695415;46970;7187.532810367518;7193.3166349196745;7300.926990730025;7328.1938986712485;7431.993361792394;10881.564737410416;11058.391788451712;11077.778444431227;11093.5562577496;11633.302001879914;10196.286259962028;10307.969203079632;10441.895581044093;10442.947785261025;10588.947055264674;10295.53670084833;10409.219308551737;10466.68599942003;10588.012856872718;10590.099841513558;7700.922990770021;9208.907910920805;9739.464329461947;10032.247581431277;10634.52144653508;8230.300424463987;8536.31709463229;8613.741587752378;8739.25716314095;8807.559622018745;8323.375746818892;8391.706290279812;8437.084251702696;8641.055762453398;8743.868841967249 09:52:27 INFO - 2015-11-11 09:52:27,179 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:52:27 INFO - 2015-11-11 09:52:27,179 DEBUG : BROWSER_OUTPUT: __start_cc_report 09:52:27 INFO - 2015-11-11 09:52:27,179 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,978 09:52:27 INFO - 2015-11-11 09:52:27,179 DEBUG : BROWSER_OUTPUT: __end_cc_report 09:52:27 INFO - 2015-11-11 09:52:27,180 DEBUG : BROWSER_OUTPUT: __startTimestamp1447264347166__endTimestamp 09:52:27 INFO - 2015-11-11 09:52:27,180 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,180 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:52:27 INFO - 2015-11-11 09:52:27,180 DEBUG : BROWSER_OUTPUT: Number of tests: 6 09:52:27 INFO - 2015-11-11 09:52:27,180 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,180 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5310.80 Median:5457.37 stddev:561.53 (10.3%) stddev-sans-first:537.83 09:52:27 INFO - 2015-11-11 09:52:27,180 DEBUG : BROWSER_OUTPUT: Values: 3181.2 3235.4 3273.4 3277.1 3296.1 5232.8 5284.0 5303.2 5441.8 5457.4 5170.3 5235.2 5297.4 5415.2 5477.8 4748.7 4890.1 4937.6 4947.7 5031.9 4605.2 5041.0 5041.5 5054.5 5137.7 4717.2 4924.5 4938.1 4954.4 4971.7 4837.9 4925.4 4930.4 4939.9 4985.8 4892.6 4913.5 4916.6 4923.3 4953.8 5045.8 5122.8 5192.4 5195.6 5376.6 5608.9 5636.5 5690.5 5700.8 5705.6 5670.4 5675.6 5708.8 5740.9 5748.4 5185.5 5226.5 5244.6 5258.6 5285.7 5747.9 5803.6 5812.4 5818.5 5840.4 5516.1 5525.4 5572.7 5578.4 5644.9 5643.3 5684.2 5724.8 5762.1 5765.9 5643.7 5691.4 5703.1 5745.7 5830.8 5598.4 5647.4 5674.1 5697.3 5706.0 4274.3 4404.2 4410.3 4476.5 4515.8 3939.7 3973.3 4001.3 4027.2 4061.5 5387.5 5426.2 5426.6 5431.3 5431.6 5593.6 5714.8 5743.1 5792.6 5827.4 5250.8 5303.6 5324.9 5327.0 5338.9 5063.6 5077.6 5079.7 5090.7 5103.0 5711.7 5844.5 5912.9 5919.7 5921.1 5669.5 5694.7 5734.7 5747.5 5814.6 5877.1 5938.6 5942.6 5944.4 5952.8 5313.8 5373.6 5660.3 5676.5 5729.3 5453.6 5609.7 5624.9 5668.2 5678.6 5573.1 5631.3 5668.3 5670.3 5674.9 5390.8 5493.1 5583.5 5638.4 5656.6 5357.4 5427.6 5436.6 5455.6 5573.5 5606.2 5612.9 5626.4 5648.5 5688.2 5416.8 5502.9 5520.0 5524.2 5532.1 09:52:27 INFO - 2015-11-11 09:52:27,181 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,181 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:46467.55 Median:35144.24 stddev:80299.32 (228.5%) stddev-sans-first:80450.51 09:52:27 INFO - 2015-11-11 09:52:27,182 DEBUG : BROWSER_OUTPUT: Values: 531.2 547.0 547.6 552.2 565.1 28577.1 29308.7 38548.4 39629.6 39885.0 40427.2 41208.8 41361.0 41466.0 41494.8 8855.4 9050.1 9053.5 9085.6 9129.9 8697.6 8822.1 8844.7 8881.7 8913.3 8823.6 8828.7 8840.2 8902.2 8960.6 8685.3 8757.4 8856.2 8856.3 8899.5 8594.1 8715.3 8726.5 8739.2 8766.9 37623.4 38005.0 38025.2 38068.0 38458.2 2885.0 2918.5 2930.1 2987.1 3236.4 26310.3 26535.7 27737.6 28322.2 29792.6 2125.5 2132.1 2182.6 2195.5 2198.5 261031.0 263113.0 264191.0 266838.0 270551.0 54837.7 56170.0 59781.4 59919.4 60094.7 61078.4 61885.4 62709.4 62875.7 62933.4 15086.7 15179.3 15186.9 15194.4 15332.9 11055.1 11288.5 11528.4 12011.6 12249.4 19633.9 19638.7 19700.4 19816.0 19877.2 8528.0 8686.2 8701.6 8733.8 8816.4 832.8 923.5 951.5 1035.2 1037.8 26179.0 26755.5 27044.5 27265.9 27314.3 1050.6 1063.4 1125.7 1159.5 1166.1 14042.7 14093.5 14098.8 14188.0 14299.5 365037.0 368459.0 370867.0 377712.0 380051.0 54233.5 54756.0 54786.0 54893.5 54967.0 1229.4 1246.3 1364.0 1389.9 1398.6 28038.6 28075.4 28082.0 28328.7 28465.0 44159.3 44981.0 45184.0 45518.8 45571.0 247443.0 255736.0 274689.0 277656.0 279941.0 29275.7 29482.9 29568.4 29745.4 30190.2 37365.6 38221.4 38273.0 38735.2 38775.2 31311.7 34525.8 34707.0 35021.8 35070.5 34600.3 34876.3 35300.0 35347.3 37475.0 35218.0 35316.1 35661.3 37842.0 38142.4 29405.6 30626.4 30718.1 30827.8 30878.5 23238.2 23259.7 23371.1 23472.0 23565.5 09:52:27 INFO - 2015-11-11 09:52:27,182 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,182 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26148.82 Median:5031.25 stddev:82631.20 (1642.4%) stddev-sans-first:82840.25 09:52:27 INFO - 2015-11-11 09:52:27,184 DEBUG : BROWSER_OUTPUT: Values: 326.1 329.1 331.7 336.8 337.6 13954.3 14494.7 16537.2 16707.0 17456.0 13217.1 13892.6 17039.4 17465.4 17547.8 5201.3 5339.4 5340.2 5342.7 5354.7 3770.0 5151.1 5274.6 5319.8 5382.1 3881.1 5622.7 5772.3 5786.6 5801.5 5712.9 5738.0 5770.5 5823.8 5826.4 4993.4 4997.5 5029.8 5032.7 5047.2 21115.8 21137.9 21138.0 21186.3 21442.2 1894.9 1899.3 1948.5 1958.4 1960.8 13097.6 13290.0 13370.9 13409.9 13458.4 1606.1 1629.2 1642.8 1667.2 1667.4 53552.0 55331.0 55888.4 56131.0 56738.4 9143.6 9374.9 9543.2 9608.1 9653.9 11671.4 11679.5 11761.6 11798.1 11798.2 7308.0 7687.4 7692.9 7754.4 7761.6 7811.8 7830.0 7836.9 7879.3 7901.2 5653.5 5746.9 5763.2 5763.9 5811.1 1508.0 1580.2 1624.7 1640.5 1659.2 844.3 908.7 920.5 1015.1 1072.8 10820.6 11339.4 11347.8 11349.1 11443.4 401.3 410.4 415.2 433.1 439.5 5837.2 5933.0 5944.4 6089.5 6174.5 495242.0 500214.0 506903.0 510700.0 513906.0 66577.0 68858.0 69150.3 69743.3 69745.0 463.9 472.1 473.6 474.5 479.2 10265.2 10377.3 10399.0 10454.2 10548.5 33291.3 33758.0 34306.3 34456.3 34977.7 42925.8 43845.6 44363.0 46797.8 50265.7 5730.1 6019.9 6021.1 6034.2 6051.2 11111.9 11208.7 11434.3 11653.1 11662.2 9675.5 9693.0 9950.3 9985.2 10092.6 9185.6 9462.8 9548.0 9577.0 9818.5 8098.7 9041.5 9486.0 9641.6 9852.9 5882.9 5922.0 5968.5 5986.9 5994.2 9248.9 9743.4 9812.1 9895.5 10028.5 09:52:27 INFO - 2015-11-11 09:52:27,184 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,184 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5330.40 Median:3539.23 stddev:2809.04 (79.4%) stddev-sans-first:2801.39 09:52:27 INFO - 2015-11-11 09:52:27,186 DEBUG : BROWSER_OUTPUT: Values: 1399.7 1451.2 1582.2 1608.4 1794.8 6902.3 7513.8 7522.2 7550.5 7558.2 7614.6 7786.7 7808.5 7846.2 7876.1 1852.6 1908.3 2087.3 2187.8 2213.8 2173.1 2173.8 2179.7 2184.0 2191.9 2097.4 2183.5 2185.9 2187.5 2188.7 1864.5 1898.1 2148.8 2186.6 2228.9 2154.0 2173.8 2203.0 2204.6 2219.2 7585.3 7622.3 7665.2 7729.0 7737.0 4609.5 4697.7 4705.0 4731.5 4759.2 2692.3 2708.5 2747.1 2753.2 2834.1 803.9 808.0 827.6 848.6 851.4 10193.8 10290.9 10312.3 10396.9 10398.1 4118.0 4149.5 4259.7 4264.0 4331.5 9159.4 9174.3 9175.7 9196.8 9277.4 4751.3 4780.5 4780.8 4789.4 4842.3 4355.6 4358.0 4366.1 4367.7 4397.4 3436.2 3499.4 3510.1 3511.9 3534.9 1143.9 1162.8 1172.6 1179.1 1189.2 906.8 1243.7 1247.1 1260.9 1267.6 6617.7 7163.9 7293.1 7312.3 7327.8 624.6 625.8 638.0 643.8 650.6 5541.8 5642.7 5685.8 5696.5 5706.3 9046.7 9062.9 9264.9 9270.1 9276.2 8977.1 9098.6 9134.2 9140.1 9155.0 7222.5 7226.5 7228.0 7242.6 7293.6 6964.5 7007.1 7024.3 7056.8 7056.9 7835.5 8172.7 8184.5 8184.6 8223.5 8287.3 8296.6 8331.5 8454.0 8459.2 6798.3 6838.5 6840.1 6842.3 6842.6 7293.2 7351.7 7360.5 7379.0 7570.5 6867.5 6892.2 6922.7 7073.8 7102.6 6751.9 6841.9 6903.7 6949.9 6955.3 5900.9 6044.7 7021.6 7046.5 7083.8 5943.7 6165.2 6188.9 6206.1 6286.0 6392.9 6434.6 6445.5 6499.0 6524.2 09:52:27 INFO - 2015-11-11 09:52:27,186 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,186 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5192.49 Median:6000.68 stddev:1587.94 (26.5%) stddev-sans-first:1549.52 09:52:27 INFO - 2015-11-11 09:52:27,187 DEBUG : BROWSER_OUTPUT: Values: 309.9 314.6 317.0 318.9 322.1 5793.6 5819.9 5854.5 5856.9 5908.6 5821.2 5852.5 5868.5 5899.6 5988.0 4541.8 4541.9 4547.6 4566.1 4601.0 4389.1 4486.3 4506.8 4574.5 4592.4 4479.9 4500.8 4507.6 4525.9 4539.2 4498.9 4511.8 4514.0 4529.0 4543.6 3934.8 3936.0 3940.4 3943.2 3951.8 5637.7 5708.3 5737.2 5779.4 5779.7 5023.9 5066.4 5072.7 5074.9 5090.8 5987.8 6178.3 6191.2 6213.0 6213.5 4096.2 4112.4 4158.8 4159.7 4167.3 6391.0 6450.1 6457.9 6489.8 6502.7 4188.3 4195.1 4202.0 4219.4 4224.8 4149.6 4212.6 4241.3 4262.5 4264.7 5017.7 5040.0 5073.3 5083.0 5084.5 6248.4 6265.8 6269.7 6271.4 6300.2 1539.5 1558.4 1561.0 1566.5 1568.0 993.6 993.8 1003.1 1009.7 1013.4 6012.5 6035.7 6041.4 6046.1 6049.4 6453.9 6490.1 6494.1 6516.4 6556.0 5988.9 6017.6 6034.4 6039.4 6056.2 3537.9 3564.5 3580.2 3593.5 3605.1 6621.9 6624.6 6632.9 6656.9 6658.2 6491.1 6583.6 6607.7 6639.9 6641.0 6397.8 6605.1 6626.2 6654.0 6798.0 6162.3 6534.2 6537.6 6540.2 6543.5 6238.5 6274.1 6278.8 6281.4 6372.9 6628.4 6629.6 6637.9 6638.6 6702.7 4093.5 4149.3 4171.6 4211.1 4245.7 6405.0 6409.6 6415.3 6419.5 6420.4 6214.1 6229.0 6235.2 6247.8 6249.1 6021.4 6190.3 6195.7 6195.8 6200.8 6092.1 6119.2 6164.4 6178.9 6179.9 6274.5 6279.2 6295.5 6323.6 6323.7 5972.3 6165.3 6173.9 6201.5 6219.0 09:52:27 INFO - 2015-11-11 09:52:27,187 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,187 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13161.40 Median:48763.13 stddev:15897.33 (32.6%) stddev-sans-first:15914.09 09:52:27 INFO - 2015-11-11 09:52:27,188 DEBUG : BROWSER_OUTPUT: Values: 632.1 632.3 699.5 700.2 743.6 13265.4 13414.8 13534.7 13542.1 13703.5 12702.2 12773.7 12816.4 12960.3 12962.7 679.9 686.5 862.6 876.6 883.0 817.5 861.8 867.7 880.0 880.2 898.3 898.5 903.0 903.1 905.4 707.6 718.9 869.9 885.0 896.6 651.9 654.1 654.7 655.9 656.6 13136.1 13144.2 13155.4 13279.7 13362.4 10421.2 11235.4 11434.0 11446.4 11503.8 8705.4 8787.4 9045.3 9225.2 9363.8 3099.6 3152.1 3211.3 3354.8 3375.0 48130.0 48289.5 48364.5 48523.5 48591.8 8440.4 8887.6 8901.2 9068.2 9120.6 18744.9 18752.6 18772.0 18786.6 18796.2 6573.5 6675.5 6692.7 6720.7 6985.8 3380.2 3486.6 3520.2 3564.4 3577.4 2698.1 2853.6 2922.4 2927.2 2930.5 448.8 456.0 457.3 460.4 462.7 472.4 495.9 524.6 527.9 595.4 6914.9 6962.4 6993.4 7105.5 7132.3 457.2 503.6 551.2 553.4 560.7 3404.0 3678.7 3833.6 3858.5 3928.9 54095.5 55526.0 57699.0 58568.4 58876.7 45093.5 47284.3 47408.8 47426.8 47500.3 43180.6 43885.0 48934.5 49016.0 49115.5 7507.8 7661.8 7781.4 8037.2 8116.1 33160.0 33546.3 33721.3 34551.0 36162.0 43874.6 46159.8 46243.3 46958.5 46970.0 7187.5 7193.3 7300.9 7328.2 7432.0 10881.6 11058.4 11077.8 11093.6 11633.3 10196.3 10308.0 10441.9 10442.9 10588.9 10295.5 10409.2 10466.7 10588.0 10590.1 7700.9 9208.9 9739.5 10032.2 10634.5 8230.3 8536.3 8613.7 8739.3 8807.6 8323.4 8391.7 8437.1 8641.1 8743.9 09:52:27 INFO - 2015-11-11 09:52:27,188 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:52:27 INFO - 2015-11-11 09:52:27,188 DEBUG : BROWSER_OUTPUT: 09:52:27 INFO - 2015-11-11 09:52:27,846 INFO : Browser exited with error code: 0 09:52:27 INFO - 2015-11-11 09:52:27,874 INFO : Completed test dromaeo_css (00:18:35) 09:52:27 INFO - 2015-11-11 09:52:27,874 INFO : Starting test kraken 09:52:27 INFO - 2015-11-11 09:52:27,874 DEBUG : operating with platform_type : mac_ 09:52:27 INFO - 2015-11-11 09:52:27,875 INFO : Initialising browser for kraken test... 09:52:27 INFO - 2015-11-11 09:52:27,887 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/tmpjTZE5m/profile http://localhost:50132/getInfo.html 09:52:30 INFO - 2015-11-11 09:52:30,289 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:52:30 INFO - 2015-11-11 09:52:30,290 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:52:30 INFO - 2015-11-11 09:52:30,290 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 09:52:30 INFO - 2015-11-11 09:52:30,290 DEBUG : BROWSER_OUTPUT: __metrics 09:52:30 INFO - 2015-11-11 09:52:30,298 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:52:30 INFO - 2015-11-11 09:52:30,969 INFO : Browser initialized. 09:52:30 INFO - 2015-11-11 09:52:30,970 INFO : Running cycle 1/1 for kraken test... 09:52:30 INFO - 2015-11-11 09:52:30,970 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/tmpjTZE5m/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:52:43 INFO - 2015-11-11 09:52:43,053 DEBUG : BROWSER_OUTPUT: RSS: Main: 228552704 09:52:43 INFO - 2015-11-11 09:52:43,053 DEBUG : BROWSER_OUTPUT: 09:52:45 INFO - 2015-11-11 09:52:45,584 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50132/tests/kraken/driver.html?testName=audio-beat-detection) 09:52:46 INFO - 2015-11-11 09:52:46,167 DEBUG : BROWSER_OUTPUT: RSS: Main: 286420992 09:52:46 INFO - 2015-11-11 09:52:46,167 DEBUG : BROWSER_OUTPUT: 09:52:48 INFO - 2015-11-11 09:52:48,810 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50132/tests/kraken/driver.html?testName=audio-dft) 09:52:49 INFO - 2015-11-11 09:52:49,390 DEBUG : BROWSER_OUTPUT: RSS: Main: 298930176 09:52:49 INFO - 2015-11-11 09:52:49,390 DEBUG : BROWSER_OUTPUT: 09:52:52 INFO - 2015-11-11 09:52:52,369 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50132/tests/kraken/driver.html?testName=audio-fft) 09:52:52 INFO - 2015-11-11 09:52:52,945 DEBUG : BROWSER_OUTPUT: RSS: Main: 281776128 09:52:52 INFO - 2015-11-11 09:52:52,945 DEBUG : BROWSER_OUTPUT: 09:52:54 INFO - 2015-11-11 09:52:54,994 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50132/tests/kraken/driver.html?testName=audio-oscillator) 09:52:55 INFO - 2015-11-11 09:52:55,580 DEBUG : BROWSER_OUTPUT: RSS: Main: 282112000 09:52:55 INFO - 2015-11-11 09:52:55,580 DEBUG : BROWSER_OUTPUT: 09:52:57 INFO - 2015-11-11 09:52:57,769 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50132/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:52:58 INFO - 2015-11-11 09:52:58,342 DEBUG : BROWSER_OUTPUT: RSS: Main: 283799552 09:52:58 INFO - 2015-11-11 09:52:58,342 DEBUG : BROWSER_OUTPUT: 09:53:01 INFO - 2015-11-11 09:53:01,392 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50132/tests/kraken/driver.html?testName=imaging-darkroom) 09:53:01 INFO - 2015-11-11 09:53:01,974 DEBUG : BROWSER_OUTPUT: RSS: Main: 283299840 09:53:01 INFO - 2015-11-11 09:53:01,974 DEBUG : BROWSER_OUTPUT: 09:53:05 INFO - 2015-11-11 09:53:05,099 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50132/tests/kraken/driver.html?testName=imaging-desaturate) 09:53:05 INFO - 2015-11-11 09:53:05,683 DEBUG : BROWSER_OUTPUT: RSS: Main: 283627520 09:53:05 INFO - 2015-11-11 09:53:05,683 DEBUG : BROWSER_OUTPUT: 09:53:08 INFO - 2015-11-11 09:53:08,548 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50132/tests/kraken/driver.html?testName=json-parse-financial) 09:53:09 INFO - 2015-11-11 09:53:09,136 DEBUG : BROWSER_OUTPUT: RSS: Main: 285278208 09:53:09 INFO - 2015-11-11 09:53:09,136 DEBUG : BROWSER_OUTPUT: 09:53:10 INFO - 2015-11-11 09:53:10,717 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50132/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:53:11 INFO - 2015-11-11 09:53:11,290 DEBUG : BROWSER_OUTPUT: RSS: Main: 317353984 09:53:11 INFO - 2015-11-11 09:53:11,291 DEBUG : BROWSER_OUTPUT: 09:53:13 INFO - 2015-11-11 09:53:13,132 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50132/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:53:13 INFO - 2015-11-11 09:53:13,743 DEBUG : BROWSER_OUTPUT: RSS: Main: 319115264 09:53:13 INFO - 2015-11-11 09:53:13,743 DEBUG : BROWSER_OUTPUT: 09:53:15 INFO - 2015-11-11 09:53:15,846 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50132/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:53:16 INFO - 2015-11-11 09:53:16,431 DEBUG : BROWSER_OUTPUT: RSS: Main: 327667712 09:53:16 INFO - 2015-11-11 09:53:16,431 DEBUG : BROWSER_OUTPUT: 09:53:19 INFO - 2015-11-11 09:53:19,030 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50132/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:53:19 INFO - 2015-11-11 09:53:19,621 DEBUG : BROWSER_OUTPUT: RSS: Main: 327823360 09:53:19 INFO - 2015-11-11 09:53:19,621 DEBUG : BROWSER_OUTPUT: 09:53:22 INFO - 2015-11-11 09:53:22,263 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50132/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:53:22 INFO - 2015-11-11 09:53:22,845 DEBUG : BROWSER_OUTPUT: RSS: Main: 328392704 09:53:22 INFO - 2015-11-11 09:53:22,845 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,595 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50132/tests/kraken/driver.html?testName=ai-astar) 09:53:24 INFO - 2015-11-11 09:53:24,848 DEBUG : BROWSER_OUTPUT: RSS: Main: 387190784 09:53:24 INFO - 2015-11-11 09:53:24,848 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,850 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:53:24 INFO - 2015-11-11 09:53:24,850 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:53:24 INFO - 2015-11-11 09:53:24,850 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:53:24 INFO - 2015-11-11 09:53:24,850 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:53:24 INFO - 2015-11-11 09:53:24,850 DEBUG : BROWSER_OUTPUT: |0;ai-astar;106;107;104;107;109;106;105;107;99;107 09:53:24 INFO - 2015-11-11 09:53:24,850 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;157;130;150;163;126;154;153;125;163;126 09:53:24 INFO - 2015-11-11 09:53:24,850 DEBUG : BROWSER_OUTPUT: |2;audio-dft;162;162;161;162;163;163;163;163;163;161 09:53:24 INFO - 2015-11-11 09:53:24,850 DEBUG : BROWSER_OUTPUT: |3;audio-fft;75;80;87;85;67;70;71;80;85;67 09:53:24 INFO - 2015-11-11 09:53:24,851 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;100;98;135;88;89;89;129;90;88;136 09:53:24 INFO - 2015-11-11 09:53:24,851 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;120;115;114;121;120;115;115;126;117;114 09:53:24 INFO - 2015-11-11 09:53:24,851 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;124;125;126;125;124;125;124;124;125;125 09:53:24 INFO - 2015-11-11 09:53:24,851 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;101;101;101;106;101;101;103;100;101;101 09:53:24 INFO - 2015-11-11 09:53:24,851 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;61;58;59;59;60;59;59;67;58;59 09:53:24 INFO - 2015-11-11 09:53:24,851 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;67;67;68;68;67;68;69;68;69;72 09:53:24 INFO - 2015-11-11 09:53:24,851 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;86;86;88;87;86;87;87;88;88;87 09:53:24 INFO - 2015-11-11 09:53:24,851 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;128;126;137;135;131;127;123;135;130;125 09:53:24 INFO - 2015-11-11 09:53:24,852 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;147;147;159;153;160;144;161;154;154;142 09:53:24 INFO - 2015-11-11 09:53:24,852 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;71;72;71;72;73;71;71;74;72;72 09:53:24 INFO - 2015-11-11 09:53:24,852 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:53:24 INFO - 2015-11-11 09:53:24,852 DEBUG : BROWSER_OUTPUT: __start_cc_report 09:53:24 INFO - 2015-11-11 09:53:24,852 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,915 09:53:24 INFO - 2015-11-11 09:53:24,852 DEBUG : BROWSER_OUTPUT: __end_cc_report 09:53:24 INFO - 2015-11-11 09:53:24,852 DEBUG : BROWSER_OUTPUT: __startTimestamp1447264404848__endTimestamp 09:53:24 INFO - 2015-11-11 09:53:24,853 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,853 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:53:24 INFO - 2015-11-11 09:53:24,853 DEBUG : BROWSER_OUTPUT: Number of tests: 14 09:53:24 INFO - 2015-11-11 09:53:24,853 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,853 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:105.70 Median:107.00 stddev:2.71 (2.5%) stddev-sans-first:2.87 09:53:24 INFO - 2015-11-11 09:53:24,855 DEBUG : BROWSER_OUTPUT: Values: 106.0 107.0 104.0 107.0 109.0 106.0 105.0 107.0 99.0 107.0 09:53:24 INFO - 2015-11-11 09:53:24,855 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,855 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:144.70 Median:153.50 stddev:16.01 (10.4%) stddev-sans-first:16.36 09:53:24 INFO - 2015-11-11 09:53:24,856 DEBUG : BROWSER_OUTPUT: Values: 157.0 130.0 150.0 163.0 126.0 154.0 153.0 125.0 163.0 126.0 09:53:24 INFO - 2015-11-11 09:53:24,856 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,856 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:162.30 Median:163.00 stddev:0.82 (0.5%) stddev-sans-first:0.87 09:53:24 INFO - 2015-11-11 09:53:24,856 DEBUG : BROWSER_OUTPUT: Values: 162.0 162.0 161.0 162.0 163.0 163.0 163.0 163.0 163.0 161.0 09:53:24 INFO - 2015-11-11 09:53:24,856 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,856 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:76.70 Median:80.00 stddev:7.70 (9.6%) stddev-sans-first:8.15 09:53:24 INFO - 2015-11-11 09:53:24,856 DEBUG : BROWSER_OUTPUT: Values: 75.0 80.0 87.0 85.0 67.0 70.0 71.0 80.0 85.0 67.0 09:53:24 INFO - 2015-11-11 09:53:24,857 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,857 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:104.20 Median:88.50 stddev:20.60 (23.3%) stddev-sans-first:21.79 09:53:24 INFO - 2015-11-11 09:53:24,857 DEBUG : BROWSER_OUTPUT: Values: 100.0 98.0 135.0 88.0 89.0 89.0 129.0 90.0 88.0 136.0 09:53:24 INFO - 2015-11-11 09:53:24,857 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,857 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:117.70 Median:118.50 stddev:3.95 (3.3%) stddev-sans-first:4.10 09:53:24 INFO - 2015-11-11 09:53:24,857 DEBUG : BROWSER_OUTPUT: Values: 120.0 115.0 114.0 121.0 120.0 115.0 115.0 126.0 117.0 114.0 09:53:24 INFO - 2015-11-11 09:53:24,858 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,858 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:124.70 Median:125.00 stddev:0.67 (0.5%) stddev-sans-first:0.67 09:53:24 INFO - 2015-11-11 09:53:24,858 DEBUG : BROWSER_OUTPUT: Values: 124.0 125.0 126.0 125.0 124.0 125.0 124.0 124.0 125.0 125.0 09:53:24 INFO - 2015-11-11 09:53:24,858 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,858 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:101.60 Median:101.00 stddev:1.71 (1.7%) stddev-sans-first:1.80 09:53:24 INFO - 2015-11-11 09:53:24,858 DEBUG : BROWSER_OUTPUT: Values: 101.0 101.0 101.0 106.0 101.0 101.0 103.0 100.0 101.0 101.0 09:53:24 INFO - 2015-11-11 09:53:24,859 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,859 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:59.90 Median:59.00 stddev:2.64 (4.5%) stddev-sans-first:2.77 09:53:24 INFO - 2015-11-11 09:53:24,859 DEBUG : BROWSER_OUTPUT: Values: 61.0 58.0 59.0 59.0 60.0 59.0 59.0 67.0 58.0 59.0 09:53:24 INFO - 2015-11-11 09:53:24,859 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,859 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.30 Median:68.00 stddev:1.49 (2.2%) stddev-sans-first:1.51 09:53:24 INFO - 2015-11-11 09:53:24,859 DEBUG : BROWSER_OUTPUT: Values: 67.0 67.0 68.0 68.0 67.0 68.0 69.0 68.0 69.0 72.0 09:53:24 INFO - 2015-11-11 09:53:24,860 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,861 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:87.00 Median:87.00 stddev:0.82 (0.9%) stddev-sans-first:0.78 09:53:24 INFO - 2015-11-11 09:53:24,861 DEBUG : BROWSER_OUTPUT: Values: 86.0 86.0 88.0 87.0 86.0 87.0 87.0 88.0 88.0 87.0 09:53:24 INFO - 2015-11-11 09:53:24,861 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,861 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:129.70 Median:130.50 stddev:4.74 (3.6%) stddev-sans-first:4.99 09:53:24 INFO - 2015-11-11 09:53:24,861 DEBUG : BROWSER_OUTPUT: Values: 128.0 126.0 137.0 135.0 131.0 127.0 123.0 135.0 130.0 125.0 09:53:24 INFO - 2015-11-11 09:53:24,861 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,862 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:152.10 Median:154.00 stddev:6.81 (4.4%) stddev-sans-first:6.96 09:53:24 INFO - 2015-11-11 09:53:24,862 DEBUG : BROWSER_OUTPUT: Values: 147.0 147.0 159.0 153.0 160.0 144.0 161.0 154.0 154.0 142.0 09:53:24 INFO - 2015-11-11 09:53:24,862 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,862 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.90 Median:72.00 stddev:0.99 (1.4%) stddev-sans-first:1.00 09:53:24 INFO - 2015-11-11 09:53:24,862 DEBUG : BROWSER_OUTPUT: Values: 71.0 72.0 71.0 72.0 73.0 71.0 71.0 74.0 72.0 72.0 09:53:24 INFO - 2015-11-11 09:53:24,862 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:53:24 INFO - 2015-11-11 09:53:24,862 DEBUG : BROWSER_OUTPUT: 09:53:25 INFO - 2015-11-11 09:53:25,504 INFO : Browser exited with error code: 0 09:53:25 INFO - 2015-11-11 09:53:25,552 INFO : Completed test kraken (00:00:57) 09:53:25 INFO - 2015-11-11 09:53:25,552 INFO : Starting test v8_7 09:53:25 INFO - 2015-11-11 09:53:25,552 DEBUG : operating with platform_type : mac_ 09:53:25 INFO - 2015-11-11 09:53:25,552 INFO : Initialising browser for v8_7 test... 09:53:25 INFO - 2015-11-11 09:53:25,568 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/tmpOVvGLF/profile http://localhost:50132/getInfo.html 09:53:27 INFO - 2015-11-11 09:53:27,862 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:53:27 INFO - 2015-11-11 09:53:27,862 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:53:27 INFO - 2015-11-11 09:53:27,862 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 09:53:27 INFO - 2015-11-11 09:53:27,862 DEBUG : BROWSER_OUTPUT: __metrics 09:53:27 INFO - 2015-11-11 09:53:27,880 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:53:28 INFO - 2015-11-11 09:53:28,569 INFO : Browser initialized. 09:53:28 INFO - 2015-11-11 09:53:28,569 INFO : Running cycle 1/1 for v8_7 test... 09:53:28 INFO - 2015-11-11 09:53:28,569 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/T/tmpOVvGLF/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:53:40 INFO - 2015-11-11 09:53:40,586 DEBUG : BROWSER_OUTPUT: RSS: Main: 228741120 09:53:40 INFO - 2015-11-11 09:53:40,586 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,040 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50132/tests/v8_7/run.html (next: http://localhost:50132/tests/v8_7/run.html) 09:54:02 INFO - 2015-11-11 09:54:02,286 DEBUG : BROWSER_OUTPUT: RSS: Main: 309080064 09:54:02 INFO - 2015-11-11 09:54:02,286 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,287 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:54:02 INFO - 2015-11-11 09:54:02,287 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:54:02 INFO - 2015-11-11 09:54:02,288 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:54:02 INFO - 2015-11-11 09:54:02,288 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:54:02 INFO - 2015-11-11 09:54:02,288 DEBUG : BROWSER_OUTPUT: |0;Richards;168.18028927009755 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.20458891013385 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |2;Encrypt;326.37075718015666 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5752.873563218391 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1904.7619047619048 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |5;Earley;917.4311926605504 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |6;Boyer;12537.5 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |7;RegExp;29794.117647058825 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |8;Splay;614.6281499692686 09:54:02 INFO - 2015-11-11 09:54:02,289 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;5871.3450292397665 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: __startTimestamp1447264442286__endTimestamp 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: Number of tests: 10 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:168.18 Median:168.18 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: Values: 168.2 09:54:02 INFO - 2015-11-11 09:54:02,290 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.20 Median:191.20 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: Values: 191.2 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:326.37 Median:326.37 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: Values: 326.4 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5752.87 Median:5752.87 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: Values: 5752.9 09:54:02 INFO - 2015-11-11 09:54:02,291 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1904.76 Median:1904.76 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: Values: 1904.8 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:917.43 Median:917.43 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: Values: 917.4 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12537.50 Median:12537.50 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: Values: 12537.5 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:29794.12 Median:29794.12 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: Values: 29794.1 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:614.63 Median:614.63 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,292 DEBUG : BROWSER_OUTPUT: Values: 614.6 09:54:02 INFO - 2015-11-11 09:54:02,293 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,293 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:5871.35 Median:5871.35 stddev:0.00 (0.0%) 09:54:02 INFO - 2015-11-11 09:54:02,293 DEBUG : BROWSER_OUTPUT: Values: 5871.3 09:54:02 INFO - 2015-11-11 09:54:02,293 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:54:02 INFO - 2015-11-11 09:54:02,293 DEBUG : BROWSER_OUTPUT: 09:54:02 INFO - 2015-11-11 09:54:02,934 INFO : Browser exited with error code: 0 09:54:02 INFO - 2015-11-11 09:54:02,954 INFO : Completed test v8_7 (00:00:37) 09:54:03 INFO - 2015-11-11 09:54:03,385 INFO : Completed test suite (00:20:11) 09:54:03 INFO - 2015-11-11 09:54:03,385 DEBUG : Working with test: dromaeo_css 09:54:03 INFO - 2015-11-11 09:54:03,385 DEBUG : Generating results file: dromaeo_css 09:54:03 INFO - 2015-11-11 09:54:03,386 DEBUG : Working with test: kraken 09:54:03 INFO - 2015-11-11 09:54:03,386 DEBUG : Generating results file: kraken 09:54:03 INFO - 2015-11-11 09:54:03,386 INFO : javascript benchmark 09:54:03 INFO - 2015-11-11 09:54:03,386 DEBUG : Working with test: v8_7 09:54:03 INFO - 2015-11-11 09:54:03,386 DEBUG : Generating results file: v8_7 09:54:03 INFO - 2015-11-11 09:54:03,387 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:54:03 INFO - 2015-11-11 09:54:03,447 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,55]] 09:54:03 INFO - 2015-11-11 09:54:03,447 DEBUG : process_Request line: dromaeo_css 6586.85 graph.html#tests=[[72,64,55]] 09:54:03 INFO - 2015-11-11 09:54:03,447 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:54:03 INFO - 2015-11-11 09:54:03,479 DEBUG : process_Request line: kraken 1506.50 graph.html#tests=[[232,64,55]] 09:54:03 INFO - 2015-11-11 09:54:03,480 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:54:03 INFO - 2015-11-11 09:54:03,514 DEBUG : process_Request line: v8_7 18376.64 graph.html#tests=[[230,64,55]] 09:54:03 INFO - 2015-11-11 09:54:03,515 INFO : javascript benchmark 09:54:03 INFO - 2015-11-11 09:54:03,517 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [326.10484220813856, 329.1425835698008, 331.74455669134767, 336.8265343348176, 337.5544281548356, 13954.30228488574, 14494.710105797878, 16537.17314134293, 16707.0, 17456.0, 13217.07480476367, 13892.583222503315, 17039.403620873272, 17465.388711395102, 17547.824521754777, 5201.349831271091, 5339.439358867321, 5340.198970154469, 5342.652727572696, 5354.678719276856, 3769.9811500942455, 5151.098557752397, 5274.5780337572905, 5319.840404787863, 5382.1119515280125, 3881.146147847469, 5622.662640241599, 5772.278465191851, 5786.56600754943, 5801.47786699197, 5712.942870571283, 5738.0, 5770.509506691915, 5823.767049318022, 5826.359100498942, 4993.400791904958, 4997.450280469146, 5029.773660185264, 5032.723200223986, 5047.192449208109, 21115.788842111535, 21137.894310528503, 21138.0, 21186.258480953245, 21442.24952126668, 1894.8768330058501, 1899.325739362534, 1948.4933917181493, 1958.3831093205595, 1960.7941166177632, 13097.607071787861, 13290.0, 13370.866291337059, 13409.86590134096, 13458.394372253271, 1606.092557704893, 1629.2098332308822, 1642.8439298266646, 1667.2330727865196, 1667.4054115971305, 53552.0, 55331.0, 55888.44111558873, 56131.0, 56738.43261567414, 9143.588538515784, 9374.90625093754, 9543.236541076698, 9608.087231712976, 9653.90346096544, 11671.35807530594, 11679.532818687327, 11761.647150585497, 11798.056155507711, 11798.233114847679, 7307.963460182665, 7687.385009199251, 7692.884606730903, 7754.3796496280165, 7761.6119194040075, 7811.80470488231, 7830.0, 7836.882446763303, 7879.290863822283, 7901.17037711032, 5653.519450846642, 5746.913796293059, 5763.193152958589, 5763.8559036024435, 5811.128330750421, 1508.0, 1580.2256894122027, 1624.6750649870073, 1640.4586486459439, 1659.1787065402702, 844.3456321351002, 908.7001289574424, 920.4799288402031, 1015.0914931136591, 1072.7961687279392, 10820.56717731282, 11339.433028348549, 11347.829782553268, 11349.09207263417, 11443.427828608535, 401.27970293323557, 410.386472224021, 415.15723082143296, 433.1315711997488, 439.52970321756055, 5837.211976383219, 5933.0, 5944.4352786485215, 6089.543284253698, 6174.536909731788, 495242.0, 500214.0, 506903.0, 510700.0, 513906.0, 66577.0, 68858.0, 69150.30849691539, 69743.3025669747, 69745.0, 463.9466461356987, 472.1430603454787, 473.6471328860021, 474.4733345986022, 479.2093046473277, 10265.178785697275, 10377.273590848568, 10399.0, 10454.163666906781, 10548.472576371305, 33291.334173316885, 33758.0, 34306.31387372188, 34456.31087378289, 34977.65022349744, 42925.78537107295, 43845.561544385426, 44363.0, 46797.766011169726, 50265.74867125641, 5730.111832665943, 6019.87960240784, 6021.126936594257, 6034.185384973148, 6051.183090282755, 11111.944440277746, 11208.71978200519, 11434.313941163557, 11653.067754579783, 11662.241954272946, 9675.516224188903, 9692.951535242279, 9950.303478756707, 9985.1512621428, 10092.646757363456, 9185.632574696938, 9462.763430914007, 9547.952260238655, 9577.0, 9818.509074546388, 8098.7165449209, 9041.547922603975, 9485.952570237105, 9641.60294886808, 9852.852207216754, 5882.882342353215, 5921.970390148022, 5968.4926781224085, 5986.9401305986385, 5994.220751302303, 9248.861267080865, 9743.366681165702, 9812.067853553901, 9895.455749933823, 10028.498575071071], "dojo.html": [3181.1569933967494, 3235.4014507316165, 3273.4435146025176, 3277.1315601365627, 3296.110050286422, 5232.816851410202, 5284.0, 5303.23103150043, 5441.755121019553, 5457.372402173752, 5170.327857378536, 5235.162374020158, 5297.417284098756, 5415.241866138734, 5477.780888764454, 4748.667593268473, 4890.119778439879, 4937.580305674022, 4947.703137811724, 5031.924521132168, 4605.194091034073, 5041.0422019816115, 5041.546260836524, 5054.5193114191015, 5137.717425541594, 4717.174494463455, 4924.532169443933, 4938.135826230413, 4954.355933728628, 4971.701697898102, 4837.927431088537, 4925.433575138869, 4930.408350997904, 4939.876503087416, 4985.800567977313, 4892.633052521075, 4913.533214344631, 4916.557509824097, 4923.335349727777, 4953.752312384367, 5045.798168073273, 5122.795088196468, 5192.402873669538, 5195.636305458619, 5376.623636345457, 5608.915866262009, 5636.464535869127, 5690.516306113986, 5700.828975130711, 5705.6291341063115, 5670.432956704338, 5675.574331925122, 5708.828735137952, 5740.913886291709, 5748.396418376094, 5185.507376799198, 5226.477352264743, 5244.580433565306, 5258.579313654898, 5285.68285902847, 5747.8563035924435, 5803.593748437569, 5812.38969908162, 5818.4763371296785, 5840.415958404211, 5516.089845175581, 5525.419830917695, 5572.693501857437, 5578.442155784389, 5644.915326270109, 5643.322801263875, 5684.232628595087, 5724.79963201286, 5762.1068734346245, 5765.88468230633, 5643.689597072201, 5691.402402747734, 5703.08750599902, 5745.6552606843725, 5830.82507524775, 5598.412166722517, 5647.37878833328, 5674.148877668383, 5697.287839020122, 5706.029974904276, 4274.273373526508, 4404.229259879508, 4410.29435290352, 4476.485204201494, 4515.75163366018, 3939.7242193046213, 3973.264945985002, 4001.299772539794, 4027.1945610877356, 4061.5126184858004, 5387.542058925035, 5426.213199086111, 5426.62013659048, 5431.34823821144, 5431.646942948696, 5593.608447408724, 5714.771409143587, 5743.109817978137, 5792.623479473821, 5827.4172582741385, 5250.842474725764, 5303.5757139429525, 5324.946750532445, 5327.0145023170835, 5338.91991620126, 5063.620228482879, 5077.593792496591, 5079.695218286841, 5090.745462726849, 5103.0, 5711.714414279187, 5844.47399734026, 5912.852178695567, 5919.733611987384, 5921.052631579013, 5669.54643628517, 5694.743736531783, 5734.741936612779, 5747.453991870766, 5814.592978491634, 5877.118432235199, 5938.643681378958, 5942.584019118794, 5944.405559444194, 5952.791652292149, 5313.760880760297, 5373.570114390761, 5660.29246344207, 5676.460736230051, 5729.3124825019595, 5453.563714902878, 5609.719514024364, 5624.887502250014, 5668.206451096932, 5678.630888992202, 5573.108302671553, 5631.2960879890015, 5668.319801623831, 5670.319561652463, 5674.914876276942, 5390.784368625368, 5493.148561972901, 5583.497485226349, 5638.436156384329, 5656.632318899258, 5357.383900851452, 5427.592930530305, 5436.565074794086, 5455.5908306876345, 5573.526250268773, 5606.215129881738, 5612.943870561242, 5626.35296940857, 5648.519875810603, 5688.203651488712, 5416.783328666809, 5502.889942201214, 5519.972400137974, 5524.171374293727, 5532.114861622121], "mootools.html": [1399.6990647010891, 1451.1800832529627, 1582.16936108543, 1608.4290077022656, 1794.8025717171117, 6902.344277293661, 7513.812154696136, 7522.247775222475, 7550.509216900905, 7558.244175582439, 7614.61926903654, 7786.702922637821, 7808.453408261424, 7846.176151504082, 7876.094249161348, 1852.6479968805952, 1908.2748555548942, 2087.269455690511, 2187.8249740020838, 2213.756486786452, 2173.1307477009245, 2173.7500187478404, 2179.7384313882276, 2184.0390228299575, 2191.934241972743, 2097.402240361497, 2183.4868805830697, 2185.8907054647284, 2187.453136715821, 2188.671699245118, 1864.4965859218003, 1898.07943147574, 2148.763636000039, 2186.6173419651495, 2228.888555572215, 2153.9784602153936, 2173.7717539658424, 2202.9779702203095, 2204.559088182354, 2219.1789038055863, 7585.317321441097, 7622.313991740714, 7665.195154508752, 7729.033870766154, 7736.961315193388, 4609.539046095397, 4697.67116301859, 4704.976475117637, 4731.503192164842, 4759.238521836524, 2692.273086266697, 2708.498927698382, 2747.148384000966, 2753.160286112755, 2834.135588645462, 803.9276465118108, 807.9757607271791, 827.6275675945849, 848.5587494502824, 851.3997631669658, 10193.796124077551, 10290.897091029143, 10312.329698569643, 10396.896031039669, 10398.116160126323, 4118.0, 4149.543550209474, 4259.701820872509, 4264.019275566637, 4331.480222373335, 9159.358844880795, 9174.311926605531, 9175.678851240174, 9196.770080747901, 9277.443353398683, 4751.311059896296, 4780.49804770501, 4780.808767649325, 4789.425268967746, 4842.346283251786, 4355.607995280377, 4357.9782101089295, 4366.061296821199, 4367.672424568106, 4397.428334316518, 3436.244026314207, 3499.4400895856543, 3510.14001569612, 3511.9122021949142, 3534.929301414009, 1143.891330323618, 1162.8430161928031, 1172.5778719660916, 1179.1038810504078, 1189.1616410430627, 906.8141031088611, 1243.6766440725296, 1247.0647014738945, 1260.8550016748009, 1267.6007057776771, 6617.735290588323, 7163.8567228656175, 7293.1248250209255, 7312.268773122645, 7327.780166594904, 624.5784095735361, 625.7841044839614, 637.977610973216, 643.8454770854961, 650.5673726971605, 5541.833744987657, 5642.746076426571, 5685.772569097273, 5696.458836410535, 5706.343770466449, 9046.683366082156, 9062.864057039149, 9264.861027084598, 9270.119338662817, 9276.211522020703, 8977.10228977097, 9098.636054557743, 9134.223590994707, 9140.085991400807, 9155.038720934339, 7222.458315626349, 7226.458015648847, 7228.024216730674, 7242.6378681065735, 7293.598852063187, 6964.512484126062, 7007.089078419773, 7024.26245244242, 7056.788296351117, 7056.858862822817, 7835.529868207926, 8172.6730930762105, 8184.508929464251, 8184.631691573774, 8223.465474744122, 8287.295579875778, 8296.585170741559, 8331.458455200393, 8453.957730211556, 8459.154084591737, 6798.252192258748, 6838.487113466411, 6840.0765896603325, 6842.315768423118, 6842.55523390978, 7293.234210407831, 7351.705931762884, 7360.484766066324, 7379.0, 7570.470067095251, 6867.450603951572, 6892.207396149306, 6922.688479018356, 7073.752418665322, 7102.573845569283, 6751.864962700817, 6841.863162736618, 6903.723851045902, 6949.930500694928, 6955.304469553004, 5900.940990590039, 6044.697765111815, 7021.613811240431, 7046.506744528039, 7083.787486375417, 5943.7028148591535, 6165.167702360303, 6188.907166392418, 6206.10011548332, 6286.0, 6392.9360706392345, 6434.613923164625, 6445.5165862561435, 6499.025146228104, 6524.151860258136], "ext.html": [531.2456312036904, 546.9917951230734, 547.6084599511349, 552.1607157121175, 565.0535353283252, 28577.14268571941, 29308.706912930866, 38548.421773673384, 39629.60370396295, 39885.0, 40427.19145617086, 41208.793956030255, 41361.0, 41466.0, 41494.7925260374, 8855.380123391365, 9050.140236677538, 9053.547322633875, 9085.591148398338, 9129.863052054225, 8697.608607612672, 8822.073682263333, 8844.690435834747, 8881.73354799357, 8913.286937045053, 8823.60293786778, 8828.690995815148, 8840.204381605654, 8902.198802107809, 8960.641574337018, 8685.261752751023, 8757.386982911199, 8856.158664926821, 8856.335774816915, 8899.466032038034, 8594.140585941419, 8715.346349023848, 8726.52004139772, 8739.213470787596, 8766.912330876674, 37623.435648465296, 38005.0, 38025.23949520994, 38068.0, 38458.23083538313, 2885.0, 2918.4892643787252, 2930.106317573139, 2987.14866263114, 3236.417444859948, 26310.342241443926, 26535.73464265352, 27737.58393624097, 28322.15033548976, 29792.553111703342, 2125.4686328417897, 2132.051237199447, 2182.5962196993605, 2195.4950361416804, 2198.483356411242, 261031.0, 263113.0, 264191.0, 266838.0, 270551.0, 54837.725811371485, 56170.0, 59781.40218597758, 59919.400805992256, 60094.69952650209, 61078.38921610727, 61885.38114618886, 62709.37290627036, 62875.68562157251, 62933.37066629275, 15086.698266034618, 15179.316930738143, 15186.924065379824, 15194.392224310905, 15332.923335383251, 11055.120629493005, 11288.492017859217, 11528.365939873387, 12011.63965081049, 12249.448774805156, 19633.901830490755, 19638.70541941872, 19700.408987730392, 19816.0, 19877.204911803656, 8528.0, 8686.218240358397, 8701.608427620773, 8733.825323493495, 8816.426932249511, 832.8459235041537, 923.5290002098978, 951.5194826612517, 1035.2390992620417, 1037.7768779712399, 26179.0, 26755.46489070208, 27044.484217051657, 27265.86367068152, 27314.31714207121, 1050.616524968381, 1063.3885515828274, 1125.7129431994952, 1159.5361855257963, 1166.102101381931, 14042.719145617031, 14093.487925383906, 14098.788518172236, 14188.0, 14299.499517516837, 365037.0, 368459.0, 370867.0, 377712.0, 380051.0, 54233.457665422844, 54756.0, 54786.0, 54893.451065488836, 54967.0, 1229.3730197599289, 1246.3269834289563, 1363.9795403068963, 1389.9374528146257, 1398.5594537720585, 28038.579421308288, 28075.438491229652, 28082.0, 28328.716712832607, 28465.0, 44159.33760993652, 44981.0, 45184.0, 45518.77240613776, 45571.0, 247443.0, 255736.0, 274689.0, 277656.0, 279941.0, 29275.7072429273, 29482.852585736935, 29568.408631827675, 29745.405091898472, 30190.245243869078, 37365.626343737305, 38221.42667859929, 38273.0, 38735.22529549449, 38775.22449550937, 31311.686883131788, 34525.82737086399, 34707.0, 35021.82489087538, 35070.47394289036, 34600.307993840484, 34876.302473950884, 35300.0, 35347.293054139285, 37475.0, 35218.0, 35316.11522732446, 35661.28677426489, 37842.0, 38142.42786358263, 29405.55891661584, 30626.387472250877, 30718.078457646305, 30827.845860770554, 30878.53682194814, 23238.167315601506, 23259.651105233097, 23371.08514985033, 23472.0, 23565.528689426457], "prototype.html": [309.85901414856244, 314.5549048096943, 316.9508726147447, 318.91548739584016, 322.0772486825246, 5793.594448388614, 5819.912701309484, 5854.531637469003, 5856.882862342751, 5908.645481271126, 5821.243238379016, 5852.531797456204, 5868.471837534621, 5899.616524925877, 5988.0, 4541.795619197144, 4541.863744087666, 4547.5907168354925, 4566.086782643468, 4600.97699511502, 4389.056352884129, 4486.327050942352, 4506.77466126694, 4574.519675434081, 4592.402987611623, 4479.865604031868, 4500.774961251941, 4507.639388848901, 4525.909481810362, 4539.160255352754, 4498.8875278117985, 4511.842085527007, 4514.0, 4529.00361920377, 4543.613792827614, 3934.8426062957446, 3935.9803200984097, 3940.4089386591954, 3943.191645712622, 3951.8024098794945, 5637.746301416405, 5708.343540492855, 5737.168110623936, 5779.422057794229, 5779.682117483537, 5023.924641130349, 5066.392032956069, 5072.695638261716, 5074.873128171826, 5090.796368145269, 5987.760489580412, 6178.320384757673, 6191.195144631214, 6212.968935155341, 6213.533984951102, 4096.160287141129, 4112.424260603518, 4158.750474971512, 4159.688023398257, 4167.312393455076, 6391.0, 6450.096986421905, 6457.903131453032, 6489.772857949996, 6502.707378167994, 4188.308929026737, 4195.098053918361, 4201.97899010503, 4219.43037689914, 4224.76763777989, 4149.564295748964, 4212.641925436372, 4241.321388577812, 4262.488501379854, 4264.6801489888385, 5017.67385119966, 5039.97480012605, 5073.315102461194, 5083.0, 5084.51697088776, 6248.4376406123665, 6265.780697675559, 6269.65516896566, 6271.435570798559, 6300.243970723543, 1539.4996626096563, 1558.3766493402502, 1560.960975975587, 1566.506550436609, 1567.968640627204, 993.6025589764153, 993.7515621094726, 1003.1373019203479, 1009.6516701737888, 1013.366645846346, 6012.518998480111, 6035.728392222272, 6041.395860414012, 6046.093086037042, 6049.425304596057, 6453.870922581522, 6490.091387205795, 6494.1232933553365, 6516.446102081376, 6555.967220163964, 5988.850278743066, 6017.638941663514, 6034.366391528914, 6039.365866583946, 6056.182415373956, 3537.911552211215, 3564.518789963322, 3580.230250496156, 3593.4969104325414, 3605.0987253186704, 6621.933780662228, 6624.6025238485845, 6632.9336706633285, 6656.866862662817, 6658.234303055114, 6491.091247225392, 6583.63789991555, 6607.735690572324, 6639.933600663931, 6641.0, 6397.840053998687, 6605.1083103780375, 6626.237982631963, 6653.9667301663185, 6798.0, 6162.291336496361, 6534.183227096613, 6537.607743535403, 6540.215174179129, 6543.509236807354, 6238.469730072813, 6274.058891166362, 6278.811635650938, 6281.371862813682, 6372.904406433814, 6628.370304821035, 6629.569078009914, 6637.900431493628, 6638.5684930479365, 6702.731890724316, 4093.4678491795876, 4149.315362965077, 4171.624553790173, 4211.0946146578635, 4245.702800804038, 6405.03924411342, 6409.583377080475, 6415.326390729093, 6419.454346380423, 6420.357964203542, 6214.067889816563, 6229.034499652561, 6235.220597425322, 6247.812565623039, 6249.093881387264, 6021.397860213943, 6190.2571691397325, 6195.659238741912, 6195.81412557624, 6200.844978875564, 6092.086187071975, 6119.2350956130485, 6164.414380634012, 6178.907316390168, 6179.938200617937, 6274.466670333073, 6279.215098112736, 6295.527835412454, 6323.620582765049, 6323.747050118128, 5972.313183983897, 6165.321814600301, 6173.938260617516, 6201.534884883562, 6219.036049412348], "yui.html": [632.0613888375761, 632.2507828223555, 699.5487910297854, 700.2402393403158, 743.5798773692865, 13265.40305686244, 13414.798778018325, 13534.661633459169, 13542.052056356059, 13703.451861925523, 12702.174358666703, 12773.744525109516, 12816.359182040907, 12960.287184204864, 12962.74074518509, 679.9184097908234, 686.4954258619911, 862.6247582301687, 876.6055275126187, 883.002207505521, 817.480899628734, 861.7845538615346, 867.6659486097834, 879.9880137841469, 880.2297989259398, 898.3172788680617, 898.5192921786845, 903.0202230579796, 903.0878812399491, 905.42053086025, 707.5613119865691, 718.8598223346476, 869.9347548933855, 884.9955750221272, 896.6010125494158, 651.9250286217051, 654.1202083198091, 654.6922946215271, 655.8950567909112, 656.6454114778014, 13136.080474366798, 13144.211347319097, 13155.40800663963, 13279.668008299774, 13362.398692058881, 10421.166306695523, 11235.438228088562, 11434.0, 11446.370449625267, 11503.827442588368, 8705.434146780502, 8787.384883058188, 9045.32160087996, 9225.16973472384, 9363.812723745486, 3099.5815564898676, 3152.0701393089093, 3211.3095684427726, 3354.815485148316, 3374.9875037488655, 48130.03739925217, 48289.5171048292, 48364.516354836705, 48523.5147648526, 48591.75704121492, 8440.366972476966, 8887.644494220158, 8901.243394311427, 9068.229200517899, 9120.58957346921, 18744.906275468536, 18752.62494750097, 18772.0, 18786.624267514846, 18796.248150074116, 6573.539852210395, 6675.465962723068, 6692.665366731644, 6720.731170753115, 6985.79042628722, 3380.2056516718553, 3486.6164721880573, 3520.2431477232517, 3564.3584154852374, 3577.409727395003, 2698.082651898364, 2853.5576985567272, 2922.415516896629, 2927.1657577590286, 2930.5164647832867, 448.75094322651245, 456.0354849493364, 457.3345781887346, 460.44286413440113, 462.7408651155364, 472.39533397251574, 495.86611614863784, 524.6065450911816, 527.8785879247718, 595.4254144750337, 6914.896276555855, 6962.408195303456, 6993.440524758109, 7105.4506679422475, 7132.322429369202, 457.1816448557112, 503.6449303241206, 551.242042191986, 553.4299671338528, 560.7084316155576, 3403.982980085084, 3678.7240956928335, 3833.600735731494, 3858.459815625815, 3928.941065884014, 54095.45904540904, 55526.0, 57699.0, 58568.414315857146, 58876.7056164725, 45093.54906450959, 47284.29073563899, 47408.76295618569, 47426.76286618545, 47500.28749568759, 43180.568194318286, 43885.0, 48934.510654893, 49016.0, 49115.508844911805, 7507.812304692427, 7661.770146895602, 7781.416393770377, 8037.23646253605, 8116.066652335057, 33160.0, 33546.329073418885, 33721.32557348888, 34551.0, 36162.0, 43874.561254387045, 46159.76920115378, 46243.3063504041, 46958.530414695415, 46970.0, 7187.532810367518, 7193.3166349196745, 7300.926990730025, 7328.1938986712485, 7431.993361792394, 10881.564737410416, 11058.391788451712, 11077.778444431227, 11093.5562577496, 11633.302001879914, 10196.286259962028, 10307.969203079632, 10441.895581044093, 10442.947785261025, 10588.947055264674, 10295.53670084833, 10409.219308551737, 10466.68599942003, 10588.012856872718, 10590.099841513558, 7700.922990770021, 9208.907910920805, 9739.464329461947, 10032.247581431277, 10634.52144653508, 8230.300424463987, 8536.31709463229, 8613.741587752378, 8739.25716314095, 8807.559622018745, 8323.375746818892, 8391.706290279812, 8437.084251702696, 8641.055762453398, 8743.868841967249]}, "summary": {"lowerIsBetter": false, "suite": 6586.84491329048, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 7459.429852012434, "unit": "ms", "value": 7459.429852012434}, "dojo.html": {"lowerIsBetter": false, "filtered": 5276.469557009289, "unit": "ms", "value": 5276.469557009289}, "mootools.html": {"lowerIsBetter": false, "filtered": 4298.147672014759, "unit": "ms", "value": 4298.147672014759}, "ext.html": {"lowerIsBetter": false, "filtered": 17851.015183103424, "unit": "ms", "value": 17851.015183103424}, "prototype.html": {"lowerIsBetter": false, "filtered": 4668.5063881949, "unit": "ms", "value": 4668.5063881949}, "yui.html": {"lowerIsBetter": false, "filtered": 5792.353485182871, "unit": "ms", "value": 5792.353485182871}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0010"}, "testrun": {"date": 1447263231, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151111072432", "branch": "Fx-Team", "revision": "94ec640656f15a9466debc0ea251de1b8d76fbc7"}}, {"talos_counters": {}, "results": {"audio-dft": [162.0, 162.0, 161.0, 162.0, 163.0, 163.0, 163.0, 163.0, 163.0, 161.0], "ai-astar": [106.0, 107.0, 104.0, 107.0, 109.0, 106.0, 105.0, 107.0, 99.0, 107.0], "imaging-gaussian-blur": [120.0, 115.0, 114.0, 121.0, 120.0, 115.0, 115.0, 126.0, 117.0, 114.0], "audio-beat-detection": [157.0, 130.0, 150.0, 163.0, 126.0, 154.0, 153.0, 125.0, 163.0, 126.0], "json-stringify-tinderbox": [67.0, 67.0, 68.0, 68.0, 67.0, 68.0, 69.0, 68.0, 69.0, 72.0], "stanford-crypto-pbkdf2": [147.0, 147.0, 159.0, 153.0, 160.0, 144.0, 161.0, 154.0, 154.0, 142.0], "json-parse-financial": [61.0, 58.0, 59.0, 59.0, 60.0, 59.0, 59.0, 67.0, 58.0, 59.0], "stanford-crypto-sha256-iterative": [71.0, 72.0, 71.0, 72.0, 73.0, 71.0, 71.0, 74.0, 72.0, 72.0], "audio-fft": [75.0, 80.0, 87.0, 85.0, 67.0, 70.0, 71.0, 80.0, 85.0, 67.0], "imaging-darkroom": [124.0, 125.0, 126.0, 125.0, 124.0, 125.0, 124.0, 124.0, 125.0, 125.0], "stanford-crypto-ccm": [128.0, 126.0, 137.0, 135.0, 131.0, 127.0, 123.0, 135.0, 130.0, 125.0], "audio-oscillator": [100.0, 98.0, 135.0, 88.0, 89.0, 89.0, 129.0, 90.0, 88.0, 136.0], "stanford-crypto-aes": [86.0, 86.0, 88.0, 87.0, 86.0, 87.0, 87.0, 88.0, 88.0, 87.0], "imaging-desaturate": [101.0, 101.0, 101.0, 106.0, 101.0, 101.0, 103.0, 100.0, 101.0, 101.0]}, "summary": {"lowerIsBetter": true, "suite": 1506.5000000000002, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 76.7, "unit": "ms", "value": 76.7}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 152.1, "unit": "ms", "value": 152.1}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 144.7, "unit": "ms", "value": 144.7}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 129.7, "unit": "ms", "value": 129.7}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 124.7, "unit": "ms", "value": 124.7}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 59.9, "unit": "ms", "value": 59.9}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 104.2, "unit": "ms", "value": 104.2}, "ai-astar": {"lowerIsBetter": true, "filtered": 105.7, "unit": "ms", "value": 105.7}, "audio-dft": {"lowerIsBetter": true, "filtered": 162.3, "unit": "ms", "value": 162.3}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 71.9, "unit": "ms", "value": 71.9}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 68.3, "unit": "ms", "value": 68.3}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 117.7, "unit": "ms", "value": 117.7}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 87.0, "unit": "ms", "value": 87.0}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 101.6, "unit": "ms", "value": 101.6}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0010"}, "testrun": {"date": 1447263231, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151111072432", "branch": "Fx-Team", "revision": "94ec640656f15a9466debc0ea251de1b8d76fbc7"}}, {"talos_counters": {}, "results": {"DeltaBlue": [191.20458891013385], "Encrypt": [326.37075718015666], "NavierStokes": [5871.3450292397665], "Decrypt": [5752.873563218391], "Splay": [614.6281499692686], "Richards": [168.18028927009755], "RegExp": [29794.117647058825], "Earley": [917.4311926605504], "Boyer": [12537.5], "RayTrace": [1904.7619047619048]}, "summary": {"lowerIsBetter": false, "suite": 18376.636708473136, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 345.79713999999984, "unit": "score", "value": 345.79713999999984}, "Encrypt": {"lowerIsBetter": false, "filtered": 815.5785839999999, "unit": "score", "value": 815.5785839999999}, "NavierStokes": {"lowerIsBetter": false, "filtered": 252.75298804780886, "unit": "score", "value": 252.75298804780886}, "Decrypt": {"lowerIsBetter": false, "filtered": 46.269224775224735, "unit": "score", "value": 46.269224775224735}, "Splay": {"lowerIsBetter": false, "filtered": 132.585857, "unit": "score", "value": 132.585857}, "RegExp": {"lowerIsBetter": false, "filtered": 30.576001974333657, "unit": "score", "value": 30.576001974333657}, "Richards": {"lowerIsBetter": false, "filtered": 209.90569199999996, "unit": "score", "value": 209.90569199999996}, "Earley": {"lowerIsBetter": false, "filtered": 726.4446699999997, "unit": "score", "value": 726.4446699999997}, "Boyer": {"lowerIsBetter": false, "filtered": 53.15756729810566, "unit": "score", "value": 53.15756729810566}, "RayTrace": {"lowerIsBetter": false, "filtered": 388.49422499999986, "unit": "score", "value": 388.49422499999986}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0010"}, "testrun": {"date": 1447263231, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151111072432", "branch": "Fx-Team", "revision": "94ec640656f15a9466debc0ea251de1b8d76fbc7"}}] 09:54:03 INFO - RETURN: dromaeo_css: 6586.85 09:54:03 INFO - RETURN: kraken: 1506.50 09:54:03 INFO - RETURN: v8_7: 18376.64 09:54:03 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,55]]", "result": "18376.64"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,55]]", "result": "1506.50"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,55]]", "result": "6586.85"}}} 09:54:03 INFO - Return code: 0 09:54:03 INFO - # TBPL SUCCESS # 09:54:03 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 09:54:03 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 09:54:03 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 09:54:03 INFO - 2015-11-11 09:54:03.646 screenresolution[2031:17957] starting screenresolution argv=screenresolution get 09:54:03 INFO - 2015-11-11 09:54:03.649 screenresolution[2031:17957] Display 0: 1600x1200x32@60 09:54:03 INFO - 2015-11-11 09:54:03.655 screenresolution[2032:17960] starting screenresolution argv=screenresolution list 09:54:03 INFO - Available Modes on Display 0 09:54:03 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 09:54:03 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 09:54:03 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 09:54:03 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 09:54:03 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 09:54:03 INFO - Intel HD Graphics 3000: 09:54:03 INFO - Chipset Model: Intel HD Graphics 3000 09:54:03 INFO - Type: GPU 09:54:03 INFO - Bus: Built-In 09:54:03 INFO - VRAM (Total): 512 MB 09:54:03 INFO - VRAM (Dynamic, Max): 10 09:54:03 INFO - Vendor: Intel (0x8086) 09:54:03 INFO - Device ID: 0x0116 09:54:03 INFO - Revision ID: 0x0009 09:54:03 INFO - Displays: 09:54:03 INFO - Display: 09:54:03 INFO - Resolution: 1600 x 1200 @ 60 Hz 09:54:03 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 09:54:03 INFO - Display Serial Number: 1600x1200 60 09:54:03 INFO - Main Display: Yes 09:54:03 INFO - Mirror: Off 09:54:03 INFO - Online: Yes 09:54:03 INFO - Rotation: Supported 09:54:03 INFO - Return code: 0 09:54:03 INFO - Running post-action listener: _resource_record_post_action 09:54:03 INFO - Running post-run listener: _resource_record_post_run 09:54:04 INFO - Total resource usage - Wall time: 1250s; CPU: 30.0%; Read bytes: 1495040; Write bytes: 682368000; Read time: 1131; Write time: 54101 09:54:04 INFO - install - Wall time: 38s; CPU: 30.0%; Read bytes: 334404096; Write bytes: 334977024; Read time: 32215; Write time: 5318 09:54:05 INFO - run-tests - Wall time: 1213s; CPU: 30.0%; Read bytes: 1495040; Write bytes: 337032192; Read time: 1131; Write time: 47574 09:54:05 INFO - Running post-run listener: _upload_blobber_files 09:54:05 INFO - Blob upload gear active. 09:54:05 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 09:54:05 INFO - Copying logs to upload dir... 09:54:05 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1771.343686 ========= master_lag: 0.27 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 29 mins, 31 secs) (at 2015-11-11 09:54:05.306366) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-11 09:54:05.309789) ========= 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.4YUf7TilnE/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.AQf6oxO7QV/Listeners TMPDIR=/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/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:0x0:0x0 using PTY: False build_url:https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010098 build_url: 'https://queue.taskcluster.net/v1/task/pzQ1aMUvQNyUACkGYdRw0A/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-11 09:54:05.341415) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:54:05.341850) ========= 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.4YUf7TilnE/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.AQf6oxO7QV/Listeners TMPDIR=/var/folders/__/r_52kyh12_vcgl0mxh6bjblh00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.005287 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:54:05.392344) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-11 09:54:05.392800) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-11 09:54:05.393427) ========= ========= Total master_lag: 0.47 =========