builder: fx-team_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0004 starttime: 1448409289.86 results: success (0) buildid: 20151124145732 builduid: 0544f187eff5434cb75c039ba4bfd614 revision: 88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.858645) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.859255) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.859582) ========= 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.QydmIq5z2R/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.R6uTyAgDro/Listeners TMPDIR=/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.005820 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.881036) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.881358) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.895687) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.896094) ========= 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.QydmIq5z2R/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.R6uTyAgDro/Listeners TMPDIR=/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005356 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.944348) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.944655) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:49.945062) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2015-11-24 15:54:49.945359) ========= 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.QydmIq5z2R/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.R6uTyAgDro/Listeners TMPDIR=/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2015-11-24 15:54:49-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 8.66M=0.001s 2015-11-24 15:54:50 (8.66 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.406909 ========= master_lag: 2.12 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2015-11-24 15:54:52.468526) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:52.468950) ========= 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.QydmIq5z2R/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.R6uTyAgDro/Listeners TMPDIR=/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.019545 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:52.505452) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2015-11-24 15:54:52.505831) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7 --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 88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners TMPDIR=/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2015-11-24 15:54:52,573 truncating revision to first 12 chars 2015-11-24 15:54:52,573 Setting DEBUG logging. 2015-11-24 15:54:52,573 attempt 1/10 2015-11-24 15:54:52,573 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/88d5bc46a549?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-24 15:54:53,773 unpacking tar archive at: fx-team-88d5bc46a549/testing/mozharness/ program finished with exit code 0 elapsedTime=1.432112 ========= master_lag: 1.25 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2015-11-24 15:54:55.187509) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:55.187844) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:55.216340) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:55.216702) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-24 15:54:55.217149) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 19 secs) (at 2015-11-24 15:54:55.217453) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners TMPDIR=/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 15:54:55 INFO - MultiFileLogger online at 20151124 15:54:55 in /builds/slave/test 15:54:55 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 15:54:55 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:54:55 INFO - {'append_to_log': False, 15:54:55 INFO - 'base_work_dir': '/builds/slave/test', 15:54:55 INFO - 'blob_upload_branch': 'Fx-Team', 15:54:55 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:54:55 INFO - 'branch': 'Fx-Team', 15:54:55 INFO - 'buildbot_json_path': 'buildprops.json', 15:54:55 INFO - 'config_files': ('talos/mac_config.py',), 15:54:55 INFO - 'default_actions': ('clobber', 15:54:55 INFO - 'read-buildbot-config', 15:54:55 INFO - 'download-and-extract', 15:54:55 INFO - 'populate-webroot', 15:54:55 INFO - 'create-virtualenv', 15:54:55 INFO - 'install', 15:54:55 INFO - 'run-tests'), 15:54:55 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:54:55 INFO - 'download_minidump_stackwalk': True, 15:54:55 INFO - 'download_symbols': 'ondemand', 15:54:55 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:54:55 INFO - 'tooltool.py': '/tools/tooltool.py', 15:54:55 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:54:55 INFO - '/tools/misc-python/virtualenv.py')}, 15:54:55 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:54:55 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:54:55 INFO - 'installer_path': 'installer.exe', 15:54:55 INFO - 'log_level': 'info', 15:54:55 INFO - 'log_name': 'talos', 15:54:55 INFO - 'log_to_console': True, 15:54:55 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 15:54:55 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 15:54:55 INFO - 'opt_config_files': (), 15:54:55 INFO - 'pip_index': False, 15:54:55 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:54:55 INFO - 'cmd': ('bash', 15:54:55 INFO - '-c', 15:54:55 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:54:55 INFO - 'enabled': True, 15:54:55 INFO - 'halt_on_failure': False, 15:54:55 INFO - 'name': 'check_screen_resolution'},), 15:54:55 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:54:55 INFO - 'cmd': ('bash', 15:54:55 INFO - '-c', 15:54:55 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:54:55 INFO - 'enabled': True, 15:54:55 INFO - 'halt_on_failure': False, 15:54:55 INFO - 'name': 'check_screen_resolution'},), 15:54:55 INFO - 'run_cmd_checks_enabled': True, 15:54:55 INFO - 'sps_profile': False, 15:54:55 INFO - 'sps_profile_interval': 0, 15:54:55 INFO - 'suite': 'dromaeojs-e10s', 15:54:55 INFO - 'system_bits': '64', 15:54:55 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:54:55 INFO - 'title': 't-yosemite-r7-0004', 15:54:55 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:54:55 INFO - 'use_talos_json': True, 15:54:55 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:54:55 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:54:55 INFO - 'work_dir': 'build'} 15:54:55 INFO - ##### 15:54:55 INFO - ##### Running clobber step. 15:54:55 INFO - ##### 15:54:55 INFO - Running pre-action listener: _resource_record_pre_action 15:54:55 INFO - Running main action method: clobber 15:54:55 INFO - rmtree: /builds/slave/test/build 15:54:55 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:54:56 INFO - Running post-action listener: _resource_record_post_action 15:54:56 INFO - ##### 15:54:56 INFO - ##### Running read-buildbot-config step. 15:54:56 INFO - ##### 15:54:56 INFO - Running pre-action listener: _resource_record_pre_action 15:54:56 INFO - Running main action method: read_buildbot_config 15:54:56 INFO - Using buildbot properties: 15:54:56 INFO - { 15:54:56 INFO - "properties": { 15:54:56 INFO - "buildnumber": 29, 15:54:56 INFO - "product": "firefox", 15:54:56 INFO - "script_repo_revision": "production", 15:54:56 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs-e10s", 15:54:56 INFO - "repository": "", 15:54:56 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs-e10s", 15:54:56 INFO - "buildid": "20151124145732", 15:54:56 INFO - "slavename": "t-yosemite-r7-0004", 15:54:56 INFO - "pgo_build": "False", 15:54:56 INFO - "basedir": "/builds/slave/test", 15:54:56 INFO - "project": "", 15:54:56 INFO - "platform": "yosemite_r7", 15:54:56 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 15:54:56 INFO - "slavebuilddir": "test", 15:54:56 INFO - "scheduler": "tests-fx-team-macosx64-talos", 15:54:56 INFO - "branch": "fx-team", 15:54:56 INFO - "repo_path": "integration/fx-team", 15:54:56 INFO - "stage_platform": "macosx64", 15:54:56 INFO - "builduid": "0544f187eff5434cb75c039ba4bfd614", 15:54:56 INFO - "revision": "88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7" 15:54:56 INFO - }, 15:54:56 INFO - "sourcestamp": { 15:54:56 INFO - "repository": "", 15:54:56 INFO - "hasPatch": false, 15:54:56 INFO - "project": "", 15:54:56 INFO - "branch": "fx-team-macosx64-talos", 15:54:56 INFO - "changes": [ 15:54:56 INFO - { 15:54:56 INFO - "category": null, 15:54:56 INFO - "files": [ 15:54:56 INFO - { 15:54:56 INFO - "url": null, 15:54:56 INFO - "name": "https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 15:54:56 INFO - } 15:54:56 INFO - ], 15:54:56 INFO - "repository": "", 15:54:56 INFO - "rev": "88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7", 15:54:56 INFO - "who": "archaeopteryx@coole-files.de", 15:54:56 INFO - "when": 1448408527, 15:54:56 INFO - "number": 6702466, 15:54:56 INFO - "comments": "Bug 1227647 - Remove UI code for legacy sync migration. r=markh", 15:54:56 INFO - "project": "", 15:54:56 INFO - "at": "Tue 24 Nov 2015 15:42:07", 15:54:56 INFO - "branch": "fx-team-macosx64-talos", 15:54:56 INFO - "revlink": "", 15:54:56 INFO - "properties": [ 15:54:56 INFO - [ 15:54:56 INFO - "buildid", 15:54:56 INFO - "20151124145732", 15:54:56 INFO - "Change" 15:54:56 INFO - ], 15:54:56 INFO - [ 15:54:56 INFO - "builduid", 15:54:56 INFO - "0544f187eff5434cb75c039ba4bfd614", 15:54:56 INFO - "Change" 15:54:56 INFO - ], 15:54:56 INFO - [ 15:54:56 INFO - "pgo_build", 15:54:56 INFO - "False", 15:54:56 INFO - "Change" 15:54:56 INFO - ] 15:54:56 INFO - ], 15:54:56 INFO - "revision": "88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7" 15:54:56 INFO - } 15:54:56 INFO - ], 15:54:56 INFO - "revision": "88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7" 15:54:56 INFO - } 15:54:56 INFO - } 15:54:56 INFO - Found installer url https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 15:54:56 INFO - Running post-action listener: _resource_record_post_action 15:54:56 INFO - ##### 15:54:56 INFO - ##### Running download-and-extract step. 15:54:56 INFO - ##### 15:54:56 INFO - Running pre-action listener: _resource_record_pre_action 15:54:56 INFO - Running main action method: download_and_extract 15:54:56 INFO - mkdir: /builds/slave/test/build/tests 15:54:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:54:56 INFO - https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 15:54:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/test_packages.json 15:54:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/test_packages.json 15:54:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 15:54:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 15:54:57 INFO - Downloaded 1149 bytes. 15:54:57 INFO - Reading from file /builds/slave/test/build/test_packages.json 15:54:57 INFO - Using the following test package requirements: 15:54:57 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:54:57 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:54:57 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 15:54:57 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:54:57 INFO - u'jsshell-mac.zip'], 15:54:57 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:54:57 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 15:54:57 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:54:57 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:54:57 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 15:54:57 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:54:57 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 15:54:57 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:54:57 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 15:54:57 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:54:57 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:54:57 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 15:54:57 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 15:54: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')]} 15:54:57 INFO - https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 15:54:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:54:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:54:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:54:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 15:54:58 INFO - Downloaded 17527659 bytes. 15:54:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 15:54:58 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:54:58 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 15:55:01 INFO - Return code: 0 15:55:01 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 15:55:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:01 INFO - https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 15:55:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:55:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:55:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:55:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 15:55:02 INFO - Downloaded 17527659 bytes. 15:55:02 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 15:55:02 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:55:02 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 15:55:06 INFO - Return code: 0 15:55:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:06 INFO - https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 15:55:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:55:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:55:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:55:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 15:55:06 INFO - Downloaded 11130997 bytes. 15:55:06 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 15:55:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:55:06 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 15:55:07 INFO - Return code: 0 15:55:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:07 INFO - https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 15:55:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:55:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:55:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 15:55:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 15:55:10 INFO - Downloaded 109910276 bytes. 15:55:10 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:55:10 INFO - mkdir: /builds/slave/test/properties 15:55:10 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:55:10 INFO - Writing to file /builds/slave/test/properties/build_url 15:55:10 INFO - Contents: 15:55:10 INFO - build_url:https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:55:10 INFO - Running post-action listener: _resource_record_post_action 15:55:10 INFO - Running post-action listener: set_extra_try_arguments 15:55:10 INFO - ##### 15:55:10 INFO - ##### Running populate-webroot step. 15:55:10 INFO - ##### 15:55:10 INFO - Running pre-action listener: _resource_record_pre_action 15:55:10 INFO - Running main action method: populate_webroot 15:55:10 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:55:10 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:55:10 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 15:55:10 INFO - '../fennec_ids.txt'], 15:55:10 INFO - 'tests': ['tcheck2']}, 15:55:10 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:55:10 INFO - '--tppagecycles', 15:55:10 INFO - '7'], 15:55:10 INFO - 'tests': ['tsvgm']}}, 15:55:10 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 15:55:10 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:55:10 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:55:10 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:55:10 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:55:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:55:10 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:55:10 INFO - 'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:55:10 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:55:10 INFO - 'tests': ['damp', 'tps']}, 15:55:10 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:55:10 INFO - 'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['damp', 'tps']}, 15:55:10 INFO - 'g3': {'tests': ['dromaeo_dom']}, 15:55:10 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:55:10 INFO - 'other': {'tests': ['a11yr', 15:55:10 INFO - 'ts_paint', 15:55:10 INFO - 'tpaint', 15:55:10 INFO - 'sessionrestore', 15:55:10 INFO - 'sessionrestore_no_auto_restore']}, 15:55:10 INFO - 'other-e10s': {'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['a11yr', 15:55:10 INFO - 'ts_paint', 15:55:10 INFO - 'tpaint', 15:55:10 INFO - 'sessionrestore', 15:55:10 INFO - 'sessionrestore_no_auto_restore']}, 15:55:10 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['a11yr', 15:55:10 INFO - 'ts_paint', 15:55:10 INFO - 'tpaint', 15:55:10 INFO - 'sessionrestore', 15:55:10 INFO - 'sessionrestore_no_auto_restore']}, 15:55:10 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['a11yr', 15:55:10 INFO - 'ts_paint', 15:55:10 INFO - 'tpaint', 15:55:10 INFO - 'sessionrestore', 15:55:10 INFO - 'sessionrestore_no_auto_restore']}, 15:55:10 INFO - 'other_l64': {'tests': ['a11yr', 15:55:10 INFO - 'ts_paint', 15:55:10 INFO - 'tpaint', 15:55:10 INFO - 'sessionrestore', 15:55:10 INFO - 'sessionrestore_no_auto_restore']}, 15:55:10 INFO - 'other_nol64': {'tests': ['a11yr', 15:55:10 INFO - 'ts_paint', 15:55:10 INFO - 'tpaint', 15:55:10 INFO - 'sessionrestore', 15:55:10 INFO - 'sessionrestore_no_auto_restore']}, 15:55:10 INFO - 'svgr': {'tests': ['tsvgx', 15:55:10 INFO - 'tsvgr_opacity', 15:55:10 INFO - 'tart', 15:55:10 INFO - 'tscrollx', 15:55:10 INFO - 'cart']}, 15:55:10 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['tsvgx', 15:55:10 INFO - 'tsvgr_opacity', 15:55:10 INFO - 'tart', 15:55:10 INFO - 'tscrollx', 15:55:10 INFO - 'cart']}, 15:55:10 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:55:10 INFO - 'tests': ['tp5o']}, 15:55:10 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:55:10 INFO - 'talos_options': ['--e10s'], 15:55:10 INFO - 'tests': ['tp5o']}, 15:55:10 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:55:10 INFO - 'talos_options': ['--xperf_path', 15:55:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:55:10 INFO - 'tests': ['tp5n']}, 15:55:10 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:55:10 INFO - 'talos_options': ['--e10s', 15:55:10 INFO - '--xperf_path', 15:55:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:55:10 INFO - 'tests': ['tp5n']}}, 15:55:10 INFO - 'talos.zip': {'path': '', 15:55:10 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:55:10 INFO - Running post-action listener: _resource_record_post_action 15:55:10 INFO - ##### 15:55:10 INFO - ##### Running create-virtualenv step. 15:55:10 INFO - ##### 15:55:10 INFO - Running pre-action listener: _resource_record_pre_action 15:55:10 INFO - Running main action method: create_virtualenv 15:55:10 INFO - Creating virtualenv /builds/slave/test/build/venv 15:55:10 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 15:55:10 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:55:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:55:10 INFO - Using real prefix '/tools/python27' 15:55:10 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:55:10 INFO - Installing distribute.............................................................................................................................................................................................done. 15:55:13 INFO - Installing pip.................done. 15:55:13 INFO - Return code: 0 15:55:13 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:55: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')]} 15:55:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:55:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55: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')]} 15:55:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:55:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55: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', '--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 0x1041dc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041b9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94b3465f70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041009f0>, '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 0x103e5fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1040f38c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:55:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 15:55:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 15:55:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/Render', 15:55:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:55:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:55:13 INFO - 'HOME': '/Users/cltbld', 15:55:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:55:13 INFO - 'LOGNAME': 'cltbld', 15:55:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:55:13 INFO - 'MOZ_NO_REMOTE': '1', 15:55:13 INFO - 'NO_EM_RESTART': '1', 15:55:13 INFO - 'PAGER': '/bin/cat', 15:55:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:55:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:55:13 INFO - 'PWD': '/builds/slave/test', 15:55:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:55:13 INFO - 'SHELL': '/bin/bash', 15:55:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.R6uTyAgDro/Listeners', 15:55:13 INFO - 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', 15:55:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:55:13 INFO - 'USER': 'cltbld', 15:55:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:55:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:55:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:55:13 INFO - 'XPC_FLAGS': '0x0', 15:55:13 INFO - 'XPC_SERVICE_NAME': '0', 15:55:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:55:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:55:14 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 15:55:14 INFO - Cleaning up... 15:55:14 INFO - Return code: 0 15:55:14 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 15:55:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:55:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:55:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1041dc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041b9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94b3465f70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041009f0>, '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 0x103e5fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1040f38c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:55:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 15:55:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 15:55:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/Render', 15:55:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:55:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:55:14 INFO - 'HOME': '/Users/cltbld', 15:55:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:55:14 INFO - 'LOGNAME': 'cltbld', 15:55:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:55:14 INFO - 'MOZ_NO_REMOTE': '1', 15:55:14 INFO - 'NO_EM_RESTART': '1', 15:55:14 INFO - 'PAGER': '/bin/cat', 15:55:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:55:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:55:14 INFO - 'PWD': '/builds/slave/test', 15:55:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:55:14 INFO - 'SHELL': '/bin/bash', 15:55:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.R6uTyAgDro/Listeners', 15:55:14 INFO - 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', 15:55:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:55:14 INFO - 'USER': 'cltbld', 15:55:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:55:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:55:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:55:14 INFO - 'XPC_FLAGS': '0x0', 15:55:14 INFO - 'XPC_SERVICE_NAME': '0', 15:55:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:55:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:55:14 INFO - Downloading/unpacking psutil>=0.7.1 15:55:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:16 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 15:55:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 15:55:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:55:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:55:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:55:16 INFO - Installing collected packages: psutil 15:55:16 INFO - Running setup.py install for psutil 15:55:17 INFO - building 'psutil._psutil_osx' extension 15:55:17 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 15:55:17 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 15:55:17 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 15:55:17 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 15:55:17 INFO - building 'psutil._psutil_posix' extension 15:55:17 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 15:55:17 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 15:55:17 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 15:55:17 INFO - ^ 15:55:17 INFO - 1 warning generated. 15:55:17 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 15:55:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:55:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:55:17 INFO - Successfully installed psutil 15:55:17 INFO - Cleaning up... 15:55:17 INFO - Return code: 0 15:55:17 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 15:55:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:55:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:55:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:17 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 0x1041dc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041b9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94b3465f70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041009f0>, '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 0x103e5fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1040f38c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:55:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 15:55:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 15:55:17 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/Render', 15:55:17 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:55:17 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:55:17 INFO - 'HOME': '/Users/cltbld', 15:55:17 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:55:17 INFO - 'LOGNAME': 'cltbld', 15:55:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:55:17 INFO - 'MOZ_NO_REMOTE': '1', 15:55:17 INFO - 'NO_EM_RESTART': '1', 15:55:17 INFO - 'PAGER': '/bin/cat', 15:55:17 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:55:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:55:17 INFO - 'PWD': '/builds/slave/test', 15:55:17 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:55:17 INFO - 'SHELL': '/bin/bash', 15:55:17 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.R6uTyAgDro/Listeners', 15:55:17 INFO - 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', 15:55:17 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:55:17 INFO - 'USER': 'cltbld', 15:55:17 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:55:17 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:55:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:55:17 INFO - 'XPC_FLAGS': '0x0', 15:55:17 INFO - 'XPC_SERVICE_NAME': '0', 15:55:17 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:55:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:55:18 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 15:55:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:20 INFO - Downloading mozsystemmonitor-0.0.tar.gz 15:55:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 15:55:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:55:20 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 15:55:20 INFO - Installing collected packages: mozsystemmonitor 15:55:20 INFO - Running setup.py install for mozsystemmonitor 15:55:20 INFO - Successfully installed mozsystemmonitor 15:55:20 INFO - Cleaning up... 15:55:20 INFO - Return code: 0 15:55:20 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:55:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:55:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:55:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:20 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 0x1041dc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041b9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94b3465f70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041009f0>, '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 0x103e5fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1040f38c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:55:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 15:55:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 15:55:20 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/Render', 15:55:20 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:55:20 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:55:20 INFO - 'HOME': '/Users/cltbld', 15:55:20 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:55:20 INFO - 'LOGNAME': 'cltbld', 15:55:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:55:20 INFO - 'MOZ_NO_REMOTE': '1', 15:55:20 INFO - 'NO_EM_RESTART': '1', 15:55:20 INFO - 'PAGER': '/bin/cat', 15:55:20 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:55:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:55:20 INFO - 'PWD': '/builds/slave/test', 15:55:20 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:55:20 INFO - 'SHELL': '/bin/bash', 15:55:20 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.R6uTyAgDro/Listeners', 15:55:20 INFO - 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', 15:55:20 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:55:20 INFO - 'USER': 'cltbld', 15:55:20 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:55:20 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:55:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:55:20 INFO - 'XPC_FLAGS': '0x0', 15:55:20 INFO - 'XPC_SERVICE_NAME': '0', 15:55:20 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:55:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:55:20 INFO - Downloading/unpacking blobuploader==1.2.4 15:55:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:22 INFO - Downloading blobuploader-1.2.4.tar.gz 15:55:22 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 15:55:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:55:23 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:55:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:23 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 15:55:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:55:23 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:55:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:24 INFO - Downloading docopt-0.6.1.tar.gz 15:55:24 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 15:55:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:55:24 INFO - Installing collected packages: blobuploader, requests, docopt 15:55:24 INFO - Running setup.py install for blobuploader 15:55:24 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:55:24 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:55:24 INFO - Running setup.py install for requests 15:55:24 INFO - Running setup.py install for docopt 15:55:24 INFO - Successfully installed blobuploader requests docopt 15:55:24 INFO - Cleaning up... 15:55:25 INFO - Return code: 0 15:55:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:55:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:55:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:55:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:25 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 0x1041dc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041b9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94b3465f70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041009f0>, '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 0x103e5fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1040f38c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:55:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 15:55:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 15:55:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/Render', 15:55:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:55:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:55:25 INFO - 'HOME': '/Users/cltbld', 15:55:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:55:25 INFO - 'LOGNAME': 'cltbld', 15:55:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:55:25 INFO - 'MOZ_NO_REMOTE': '1', 15:55:25 INFO - 'NO_EM_RESTART': '1', 15:55:25 INFO - 'PAGER': '/bin/cat', 15:55:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:55:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:55:25 INFO - 'PWD': '/builds/slave/test', 15:55:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:55:25 INFO - 'SHELL': '/bin/bash', 15:55:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.R6uTyAgDro/Listeners', 15:55:25 INFO - 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', 15:55:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:55:25 INFO - 'USER': 'cltbld', 15:55:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:55:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:55:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:55:25 INFO - 'XPC_FLAGS': '0x0', 15:55:25 INFO - 'XPC_SERVICE_NAME': '0', 15:55:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:55:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:55:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:55:25 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-UbsmjI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:55:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:55:25 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-mTYP6D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:55:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:55:25 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-wHr3mF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:55:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:55:25 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-Kvl34P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:55:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:55:25 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-bXwdin-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:55:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:55:25 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-bkzMb9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:55:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:55:25 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-vVX8xq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:55:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:55:25 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-qYC93a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-UhtPMC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-TtnaRg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-hpO954-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-2tp32u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-wi9iAY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-Fy2XXp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-pOSY5D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-68clYx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:55:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:55:26 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-P1yGMX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:55:27 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:55:27 INFO - Running setup.py install for manifestparser 15:55:27 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:55:27 INFO - Running setup.py install for mozcrash 15:55:27 INFO - Running setup.py install for mozdebug 15:55:27 INFO - Running setup.py install for mozdevice 15:55:27 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:55:27 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:55:27 INFO - Running setup.py install for mozfile 15:55:27 INFO - Running setup.py install for mozhttpd 15:55:27 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:55:27 INFO - Running setup.py install for mozinfo 15:55:28 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Running setup.py install for mozInstall 15:55:28 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Running setup.py install for mozleak 15:55:28 INFO - Running setup.py install for mozlog 15:55:28 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Running setup.py install for moznetwork 15:55:28 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Running setup.py install for mozprocess 15:55:28 INFO - Running setup.py install for mozprofile 15:55:28 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:55:28 INFO - Running setup.py install for mozrunner 15:55:29 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:55:29 INFO - Running setup.py install for mozscreenshot 15:55:29 INFO - Running setup.py install for moztest 15:55:29 INFO - Running setup.py install for mozversion 15:55:29 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:55:29 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:55:29 INFO - Cleaning up... 15:55:29 INFO - Return code: 0 15:55:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:55:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:55:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:55:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:29 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 0x1041dc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041b9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94b3465f70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041009f0>, '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 0x103e5fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1040f38c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:55:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 15:55:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 15:55:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/Render', 15:55:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:55:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:55:29 INFO - 'HOME': '/Users/cltbld', 15:55:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:55:29 INFO - 'LOGNAME': 'cltbld', 15:55:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:55:29 INFO - 'MOZ_NO_REMOTE': '1', 15:55:29 INFO - 'NO_EM_RESTART': '1', 15:55:29 INFO - 'PAGER': '/bin/cat', 15:55:29 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:55:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:55:29 INFO - 'PWD': '/builds/slave/test', 15:55:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:55:29 INFO - 'SHELL': '/bin/bash', 15:55:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.R6uTyAgDro/Listeners', 15:55:29 INFO - 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', 15:55:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:55:29 INFO - 'USER': 'cltbld', 15:55:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:55:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:55:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:55:29 INFO - 'XPC_FLAGS': '0x0', 15:55:29 INFO - 'XPC_SERVICE_NAME': '0', 15:55:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:55:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:55:29 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-IsFbK_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:55:29 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 15:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:55:29 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-PWDVaa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-PQ7enZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-1fLQxP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-2WgmPd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-qHd9aD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-hIiTiE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-MHEYH1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-zdjInv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-BC793o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:55:30 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-53woex-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 15:55:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:55:31 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-1CskBQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 15:55:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:55:31 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-UEg1SU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 15:55:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:55:31 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-6exmXM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 15:55:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:55:31 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-SfvFmG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 15:55:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:55:31 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-31TfpQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 15:55:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:55:31 INFO - Running setup.py (path:/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/pip-HfPZtM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:55:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:55:31 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:55:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:55:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:55:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:55:33 INFO - Downloading blessings-1.5.1.tar.gz 15:55:33 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 15:55:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:55:33 INFO - Installing collected packages: blessings 15:55:33 INFO - Running setup.py install for blessings 15:55:34 INFO - Successfully installed blessings 15:55:34 INFO - Cleaning up... 15:55:34 INFO - Return code: 0 15:55:34 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:55:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:55:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:55:34 INFO - Reading from file tmpfile_stdout 15:55:34 INFO - Current package versions: 15:55:34 INFO - blessings == 1.5.1 15:55:34 INFO - blobuploader == 1.2.4 15:55:34 INFO - docopt == 0.6.1 15:55:34 INFO - manifestparser == 1.1 15:55:34 INFO - mozInstall == 1.12 15:55:34 INFO - mozcrash == 0.16 15:55:34 INFO - mozdebug == 0.1 15:55:34 INFO - mozdevice == 0.47 15:55:34 INFO - mozfile == 1.2 15:55:34 INFO - mozhttpd == 0.7 15:55:34 INFO - mozinfo == 0.9 15:55:34 INFO - mozleak == 0.1 15:55:34 INFO - mozlog == 3.1 15:55:34 INFO - moznetwork == 0.27 15:55:34 INFO - mozprocess == 0.22 15:55:34 INFO - mozprofile == 0.27 15:55:34 INFO - mozrunner == 6.11 15:55:34 INFO - mozscreenshot == 0.1 15:55:34 INFO - mozsystemmonitor == 0.0 15:55:34 INFO - moztest == 0.7 15:55:34 INFO - mozversion == 1.4 15:55:34 INFO - psutil == 3.1.1 15:55:34 INFO - requests == 1.2.3 15:55:34 INFO - wsgiref == 0.1.2 15:55:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:55:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:55:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:55:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:55:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:55:34 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 0x1041dc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041b9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94b3465f70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1041009f0>, '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 0x103e5fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1040f38c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/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.R6uTyAgDro/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:55:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 15:55:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 15:55:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/Render', 15:55:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:55:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:55:34 INFO - 'HOME': '/Users/cltbld', 15:55:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:55:34 INFO - 'LOGNAME': 'cltbld', 15:55:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:55:34 INFO - 'MOZ_NO_REMOTE': '1', 15:55:34 INFO - 'NO_EM_RESTART': '1', 15:55:34 INFO - 'PAGER': '/bin/cat', 15:55:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:55:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:55:34 INFO - 'PWD': '/builds/slave/test', 15:55:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:55:34 INFO - 'SHELL': '/bin/bash', 15:55:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.R6uTyAgDro/Listeners', 15:55:34 INFO - 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', 15:55:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:55:34 INFO - 'USER': 'cltbld', 15:55:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:55:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:55:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:55:34 INFO - 'XPC_FLAGS': '0x0', 15:55:34 INFO - 'XPC_SERVICE_NAME': '0', 15:55:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:55:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 15:55:34 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:55:34 INFO - Cleaning up... 15:55:34 INFO - Return code: 0 15:55:34 INFO - Running post-action listener: _resource_record_post_action 15:55:34 INFO - Running post-action listener: _start_resource_monitoring 15:55:34 INFO - Starting resource monitoring. 15:55:34 INFO - ##### 15:55:34 INFO - ##### Running install step. 15:55:34 INFO - ##### 15:55:34 INFO - Running pre-action listener: _resource_record_pre_action 15:55:34 INFO - Running main action method: install 15:55:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:55:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:55:35 INFO - Reading from file tmpfile_stdout 15:55:35 INFO - Detecting whether we're running mozinstall >=1.0... 15:55:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:55:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:55:35 INFO - Reading from file tmpfile_stdout 15:55:35 INFO - Output received: 15:55:35 INFO - Usage: mozinstall [options] installer 15:55:35 INFO - Options: 15:55:35 INFO - -h, --help show this help message and exit 15:55:35 INFO - -d DEST, --destination=DEST 15:55:35 INFO - Directory to install application into. [default: 15:55:35 INFO - "/builds/slave/test"] 15:55:35 INFO - --app=APP Application being installed. [default: firefox] 15:55:35 INFO - mkdir: /builds/slave/test/build/application 15:55:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 15:55:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 15:56:05 INFO - Reading from file tmpfile_stdout 15:56:05 INFO - Output received: 15:56:05 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 15:56:05 INFO - Running post-action listener: _resource_record_post_action 15:56:05 INFO - ##### 15:56:05 INFO - ##### Running run-tests step. 15:56:05 INFO - ##### 15:56:05 INFO - Running pre-action listener: _resource_record_pre_action 15:56:05 INFO - Running main action method: run_tests 15:56:05 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 15:56:05 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 15:56:05 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 15:56:05 INFO - 2015-11-24 15:56:05.491 screenresolution[1969:21518] starting screenresolution argv=screenresolution get 15:56:05 INFO - 2015-11-24 15:56:05.493 screenresolution[1969:21518] Display 0: 1600x1200x32@60 15:56:05 INFO - 2015-11-24 15:56:05.499 screenresolution[1970:21520] starting screenresolution argv=screenresolution list 15:56:05 INFO - Available Modes on Display 0 15:56:05 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 15:56:05 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 15:56:05 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 15:56:05 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 15:56:05 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 15:56:05 INFO - Intel Iris: 15:56:05 INFO - Chipset Model: Intel Iris 15:56:05 INFO - Type: GPU 15:56:05 INFO - Bus: Built-In 15:56:05 INFO - VRAM (Dynamic, Max): 1536 MB 15:56:05 INFO - Vendor: Intel (0x8086) 15:56:05 INFO - Device ID: 0x0a2e 15:56:05 INFO - Revision ID: 0x0009 15:56:05 INFO - Displays: 15:56:05 INFO - Display: 15:56:05 INFO - Resolution: 1600 x 1200 @ 60 Hz 15:56:05 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 15:56:05 INFO - Display Serial Number: 1600x1200 60 15:56:05 INFO - Main Display: Yes 15:56:05 INFO - Mirror: Off 15:56:05 INFO - Online: Yes 15:56:05 INFO - Rotation: Supported 15:56:05 INFO - Return code: 0 15:56:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:56:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:56:05 INFO - Python 2.7.3 15:56:05 INFO - Return code: 0 15:56:05 INFO - grabbing minidump binary from tooltool 15:56:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:56:05 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 0x1041009f0>, '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 0x103e5fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1040f38c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:56:05 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 15:56:05 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 15:56:05 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:56:05 INFO - Return code: 0 15:56:05 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 15:56:05 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:56:05 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:56:05 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 15:56:05 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:56:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0004', '--webServer', 'localhost'] in /builds/slave/test/build 15:56:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0004 --webServer localhost 15:56:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QydmIq5z2R/Render', 15:56:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:56:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:56:05 INFO - 'HOME': '/Users/cltbld', 15:56:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:56:05 INFO - 'LOGNAME': 'cltbld', 15:56:05 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:56:05 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 15:56:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:56:05 INFO - 'MOZ_NO_REMOTE': '1', 15:56:05 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:56:05 INFO - 'NO_EM_RESTART': '1', 15:56:05 INFO - 'PAGER': '/bin/cat', 15:56:05 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:56:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:56:05 INFO - 'PWD': '/builds/slave/test', 15:56:05 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:56:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:56:05 INFO - 'SHELL': '/bin/bash', 15:56:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.R6uTyAgDro/Listeners', 15:56:05 INFO - 'TMPDIR': '/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/', 15:56:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:56:05 INFO - 'USER': 'cltbld', 15:56:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:56:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:56:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:56:05 INFO - 'XPC_FLAGS': '0x0', 15:56:05 INFO - 'XPC_SERVICE_NAME': '0', 15:56:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:56:05 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0004', '--webServer', 'localhost'] with output_timeout 3600 15:56:06 INFO - mozversion INFO | application_buildid: 20151124145732 15:56:06 INFO - mozversion INFO | application_changeset: 88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7 15:56:06 INFO - mozversion INFO | application_display_name: Nightly 15:56:06 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:56:06 INFO - mozversion INFO | application_name: Firefox 15:56:06 INFO - mozversion INFO | application_remotingname: firefox 15:56:06 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 15:56:06 INFO - mozversion INFO | application_vendor: Mozilla 15:56:06 INFO - mozversion INFO | application_version: 45.0a1 15:56:06 INFO - mozversion INFO | platform_buildid: 20151124145732 15:56:06 INFO - mozversion INFO | platform_changeset: 88d5bc46a5498c15306d6a360c1a57f1cfbc3ea7 15:56:06 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 15:56:06 INFO - mozversion INFO | platform_version: 45.0a1 15:56:06 INFO - 2015-11-24 15:56:06,036 DEBUG : using testdate: 1448409366 15:56:06 INFO - 2015-11-24 15:56:06,036 DEBUG : actual date: 1448409366 15:56:06 INFO - 2015-11-24 15:56:06,379 INFO : starting webserver on 'localhost:50745' 15:56:06 INFO - 2015-11-24 15:56:06,380 INFO : Starting test suite t-yosemite-r7-0004.e 15:56:06 INFO - 2015-11-24 15:56:06,380 INFO : Starting test dromaeo_css 15:56:06 INFO - 2015-11-24 15:56:06,380 DEBUG : operating with platform_type : mac_ 15:56:06 INFO - 2015-11-24 15:56:06,381 INFO : Initialising browser for dromaeo_css test... 15:56:06 INFO - 2015-11-24 15:56:06,391 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/tmpHo_2pn/profile http://localhost:50745/getInfo.html 15:56:09 INFO - 2015-11-24 15:56:09,404 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 15:56:09 INFO - 2015-11-24 15:56:09,404 DEBUG : BROWSER_OUTPUT: colorDepth:24 15:56:09 INFO - 2015-11-24 15:56:09,404 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 15:56:09 INFO - 2015-11-24 15:56:09,404 DEBUG : BROWSER_OUTPUT: __metrics 15:56:10 INFO - 2015-11-24 15:56:10,008 INFO : Browser initialized. 15:56:10 INFO - 2015-11-24 15:56:10,008 INFO : Running cycle 1/1 for dromaeo_css test... 15:56:10 INFO - 2015-11-24 15:56:10,008 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/tmpHo_2pn/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 15:56:21 INFO - 2015-11-24 15:56:21,873 DEBUG : BROWSER_OUTPUT: RSS: Main: 236642304 15:56:21 INFO - 2015-11-24 15:56:21,873 DEBUG : BROWSER_OUTPUT: 15:57:11 INFO - 2015-11-24 15:57:11,568 DEBUG : BROWSER_OUTPUT: 1448409431565 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 15:59:22 INFO - 2015-11-24 15:59:22,164 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50745/tests/dromaeo/cssquery-ext.html) 15:59:23 INFO - 2015-11-24 15:59:23,479 DEBUG : BROWSER_OUTPUT: RSS: Main: 256606208 15:59:23 INFO - 2015-11-24 15:59:23,479 DEBUG : BROWSER_OUTPUT: 16:02:25 INFO - 2015-11-24 16:02:25,408 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/dromaeo/cssquery-ext.html (next: http://localhost:50745/tests/dromaeo/cssquery-jquery.html) 16:02:26 INFO - 2015-11-24 16:02:26,007 DEBUG : BROWSER_OUTPUT: RSS: Main: 265416704 16:02:26 INFO - 2015-11-24 16:02:26,007 DEBUG : BROWSER_OUTPUT: 16:05:27 INFO - 2015-11-24 16:05:27,729 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50745/tests/dromaeo/cssquery-mootools.html) 16:05:28 INFO - 2015-11-24 16:05:28,331 DEBUG : BROWSER_OUTPUT: RSS: Main: 265351168 16:05:28 INFO - 2015-11-24 16:05:28,331 DEBUG : BROWSER_OUTPUT: 16:08:29 INFO - 2015-11-24 16:08:29,940 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50745/tests/dromaeo/cssquery-prototype.html) 16:08:30 INFO - 2015-11-24 16:08:30,539 DEBUG : BROWSER_OUTPUT: RSS: Main: 268677120 16:08:30 INFO - 2015-11-24 16:08:30,539 DEBUG : BROWSER_OUTPUT: 16:11:33 INFO - 2015-11-24 16:11:33,079 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50745/tests/dromaeo/cssquery-yui.html) 16:11:33 INFO - 2015-11-24 16:11:33,682 DEBUG : BROWSER_OUTPUT: RSS: Main: 271331328 16:11:33 INFO - 2015-11-24 16:11:33,682 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,055 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/dromaeo/cssquery-yui.html (next: http://localhost:50745/tests/dromaeo/cssquery-dojo.html) 16:14:36 INFO - 2015-11-24 16:14:36,317 DEBUG : BROWSER_OUTPUT: RSS: Main: 274018304 16:14:36 INFO - 2015-11-24 16:14:36,317 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,317 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:14:36 INFO - 2015-11-24 16:14:36,318 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:14:36 INFO - 2015-11-24 16:14:36,318 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:14:36 INFO - 2015-11-24 16:14:36,318 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:14:36 INFO - 2015-11-24 16:14:36,318 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3438.6389429109945;3478.2347883465627;3494.4234201356776;3532.311199316131;3552.6447355264468;5796.768129274824;5924.585279030464;5954.950027348222;5991.161237426758;6020.488258498022;5755.0504166812425;5841.415858414157;5867.207926929863;5951.494122999539;5987.161797348374;5274.683518988863;5308.522232999029;5341;5371.248025276464;5384.892302153955;5329.973350133244;5359.16932875403;5374.516293533581;5396.622236443451;5420.539254163401;5022.974885125587;5177.534021938006;5183.196604526267;5308.177232528964;5309.283246761695;5274.182501712241;5293.3647962244395;5301.973490132563;5331.813386531491;5352.143657014898;5252.054630166568;5277.762500687479;5329.866753331159;5341.252224688546;5369.650972686802;5114.872128196787;5288.519214619912;5618;5637.3517045539875;5767.682777447239;6302.684865756693;6306.9684651576445;6314.494840412756;6329.746810127589;6372.553921225516;6172.969135154295;6342.556021078526;6382.266039405435;6413.390727880844;6415.93584064158;5866.384029676865;5944.108383742473;6016.939830601638;6030.969845150747;6083.695815209177;6428.325025872309;6443.162388889508;6529.608223506605;6545.410913017851;6546.9017964730565;6034;6214.751409943552;6316.747330106836;6343.524235682342;6354.745810167541;5198.532132108128;6292.2134733158355;6304.810855674337;6345.07996340528;6362.045693145972;6284.497240220771;6300.873982520324;6326.652034138075;6343.714532846033;6355.046742988497;6149.600275982047;6150.169727086875;6241.563090583615;6265.310815810257;6295.874082518324;5083.593312535062;5093.974530127326;5101.107306221471;5111.080005599028;5112.6421150519855;4569.177548041384;4590.472095708969;4592.632589392841;4605.125026245003;4654.790534425959;5783.103618939072;5800.6809625471005;5829;5977.880442391215;6050.42520960508;6328;6400.519961002943;6444.516661250425;6453.677316134174;6461.61230326182;5989.251343582052;6027.21646185993;6029.3970602940235;6031.5476339273855;6049.818505444844;4820.662553621213;5368.033753924331;5372.059889519397;5509.3664228613425;5512.641678290898;6468;6475.18078986696;6508.284088750233;6526;6661.134052573135;6203.937960620336;6343.048542718445;6347.5556711029785;6354.555181137276;6361.745530178741;5394.865128371822;6296.937030629635;6374.1394911688185;6439.420452159328;6439.774607888701;6290.370962903673;6311.2426508819235;6320.810375688737;6322.0516922462;6364.268109167505;6154.353792851865;6293.213348331458;6409.2949775525585;6436.324185960594;6442.677866106582;5623.606347555632;6005.699715014319;6118.877622447615;6177.382261773787;6224.595401298901;6217.036359364306;6240.58018593421;6301.338359472189;6330.873382532415;6373.681315934277;5810.7094645266725;5855.765769369348;6109.755609775737;6184.5980011299125;6217.937820621736;6101.186783078283;6160.630362178284;6179.5056395489155;6190.907136392868;6205.751769929152;6105.908411373922;6214.347493513297;6223.813285601439;6231.9688401557705;6240.219972503437 16:14:36 INFO - 2015-11-24 16:14:36,319 DEBUG : BROWSER_OUTPUT: |1;ext.html;549.7663493015467;582.0047718401534;589.4753669234385;599.7241269016253;632.8987362022077;41510.16979660405;42072;42119;42243;42322.365164522555;43252.3512147318;43763;43773.78113109438;43776;43822.34266485997;9738.707838764849;9844.655437059704;9931.404115753041;9941.701748947544;9949.452780097092;9723.416595004286;9848.606055757797;9863.556139973718;9891.109800117987;9902.950485247564;9797.902020979805;9860.654877079303;9891.604335826594;9903.009699030112;9908.603655853793;8454.535000574966;9798.216142708601;9816.263780216512;9847.90152098477;9875.654352097677;9427.67003154893;9630.98874618162;9786.1192492676;9786.853197202048;9829.3610915291;40690.79654601708;40760.38859417111;40840.387394188816;40996.79501602473;41161.794191029156;3172.0483854843687;3279.4916787897914;3409.539712138879;3477.3914564951033;3530.6116327203986;28716.13851584456;29013;29359.41281174386;29553;29594.70405295941;2757.2831063923322;2762.4475104978883;2786.879522819196;2972.8513574321414;2986.641603007631;499939;504085;506656.99999999633;506859;507148.32129196695;63924.68037659782;65811;72198;74975.62512187404;77148.61425692835;63829.68085159637;75618.21908904533;75649.62175189199;75938.62030689922;76175.14423701783;16411.753823692656;16446.6710665786;16593.087380194203;16604.67162626987;16619.169041548117;10196.592136314614;12396;12405.875941240653;12425.068119891044;12673.429695663717;22734;22828.31515054551;22960.425989350068;23052.308430747104;23083.653745193835;9679.66121185755;9882;9909.355891867006;9917.107460328605;9946;902.8104098139333;985.4875464758286;986.9851952220722;1053.146950969717;1054.2988912373187;28788.568171477444;33732.49401258983;34014.659853401645;34294;34294;1043.6660268713938;1068.6420049283577;1131.462555286249;1132.6262333429947;1162.976740465186;15493.690126197413;15515;15628.857118585755;15739.921300393426;15745.212739362985;532520.3373983105;625969.7403025911;650000;658510;659318;62482.68758656178;62901;62914.68542657257;63025.369746302866;63061.36938630647;1413.964650883736;1421.85070567591;1443.2422977936667;1443.7040406716599;1454.832694240176;30206.09381718552;30227.79088836422;30274.69725302719;30488.542671859497;30666.386672266875;53175.734121329144;53523.464765353405;53664;53868.999999998436;53942.112026078896;402507;500369;500510;501486;507405;34008.48987265144;46401;47304.7634761824;48838.5116148834;49016.75491622519;39558.604413956644;47152;47505.812354690024;47693.5230647703;48737;37533.81233093817;38145.2370952585;39622;40115.79942100271;40405.393919090646;38628.80685596554;39234.411483828335;39287.41068884026;39940.800295998335;40249.99375015648;38337.616623833404;38748;38960.610393895695;38992;39143.80428097841;32336.676633234307;34945;34959;35113.648863511036;35339.29321413609;25813.615360101885;25875.353116171493;25876.35309117287;26190.08334708276;26227.475450491263 16:14:36 INFO - 2015-11-24 16:14:36,321 DEBUG : BROWSER_OUTPUT: |2;jquery.html;290.4293064128986;367.7683059672406;367.77014366021234;368.8008475423272;369.33519664603705;16619.83380166201;20211.696824547642;20453.284135055277;20523.589528209428;21012.474688132803;17760;17840.732389014174;17853.7321940171;20277.188912443486;20575.27986520472;5051.823186188484;6193.6593487358405;6205.689715514229;6207.162033125538;6219.720112594921;5685.118806584966;5793.044147715622;5878.617889837147;5889.911651325234;6099.237595300588;5793.739281732311;5849.64902105875;5874.70626468677;6554.246261679897;6558.409743123118;6527.673616319189;6549.410553050248;6571.638559879205;6583.802485925406;6608.372204640552;5309;5436.238926550286;5491.643043202179;5510.035743744828;5719.598698318897;12984.28586427746;14425.567232983027;19987.10058047377;20135.0939207736;24474.388140296458;1943.6598595245916;2007.2874129684044;2040.734704488407;2164.8159906407973;2296.9655455168186;9757.024297570257;9880.654177103766;9948.955359687201;10082.24383171265;14019.71960560783;1709.623882745794;1713.9314427422887;1745.6683230186225;1773.485689150158;1820.8490687600931;101130;101512;101968;102611.48694256555;104093;11207.103431725442;11237.71905702364;11284.71788205285;11331;11399.544018239178;12144.02847772176;12415;12533.811992820116;13029.348532573333;13045.412956416794;6437.356264373619;8128.715494957648;8220.05469371018;8251.133630968781;8266.380021498411;8313.916860831436;8323.042850072197;8323.292520135856;8324.542150181676;8435.536045517556;4362.520122786491;4364.10535840152;4401.295792673221;4431.135928493977;4462.973516091252;1853.1197681101369;1887.6602211602044;1890.5840715042668;1892.1579896946002;1894.535838719495;905.316486053039;948.83869742144;993.513178542509;1001.4892404873567;1015.9085682288481;15351.002184857949;20598.485037873874;20887.895560522404;21053;21195.78804211969;796.3469954637142;894.9015608283083;899.9325050621229;913.2237598041611;977.3354119198871;9800.852987205197;11505.654830355103;11541.019013383957;11677.766444671059;11713.18007739467;745803;750310;760682;775443;778058;117256.41371793086;117972;119312;120367;122915.3854230741;1235.7837378458735;1239.4050855589367;1240.8573014103495;1245.2466257914014;1256.6418570707306;16793.580160495596;18880.33918812835;19105.94917279563;19192.904035480293;19448.41654750303;48582.27126593033;50139.74930125326;50435;52030;55339;64690;74057;74500;74588.25411745813;75114.4977100444;9633.951830240803;9729.951350243204;9788.706338809847;9903.801923961337;9975;11875.76248475043;11884.286942783461;19040.905500394667;19559.70660440066;19749.901250493655;15543.84456155424;15619.297131629331;15937.68124637524;16055.759163612789;16060.839391606401;15502.9224853875;15665.765013524579;15834.366625335319;15869.682606347578;16297.26662300223;16268.67462650764;16630.806603539928;17225.827741722424;17305.30778768835;17464.12679366052;9611.038896110333;9867.457289849128;9934.552945117632;10100.595976161165;10159.492025398553;15740.97683650559;15746.527604171893;16055.919720401324;16247.837521625106;16264.349426022827 16:14:36 INFO - 2015-11-24 16:14:36,325 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1514.2428785607196;1546.8221154567227;1899.5820919397727;1906.8273012097557;1928.990355048225;7598.354139898115;7668.578228197461;8175.100738918722;8632.39573229874;8638.049814520406;8129.268365847072;8288.70989515367;8388.203120703538;8424.157584241573;8447.873281900776;2323.163661082009;2355.693759811231;2361.055577768898;2368.2895131460577;2371.122684606698;2355.7290911545133;2388.235764555343;2421.5641184586766;2428.7085549734056;2434.075051480435;2336.3691803213205;2347.6361164019604;2383.84505007174;2387.582173119697;2391.7129944406697;2313.7686231376897;2352.3531028967086;2372.146027430124;2373.8100951923893;2380.1550449590404;2383.7377888432256;2397.1490121006964;2412.0954642009247;2419.0928401849305;2426.478307163968;8426.241638252586;8475.576221188978;8477.067522572512;8493.320534357299;8503.787405314855;4660.906781864378;5166.870828229286;5225.111731005738;5247.291615631917;5252.290940722992;3206.5350524173864;3448.1724386147393;3452.8100954447495;3482.0250329907667;3525.6121826599056;894.9015608283083;1028.619410818002;1051.9579216831316;1056.9324981768393;1068.8984546468073;9391.90608093924;10962.397068161248;10993.395363255018;11036.392998385085;11087.113030957504;4036.354183330653;4714.175019371596;4741.312509686076;4788.904221915543;4789.640776941744;9647.986961368955;9655.613775448903;9675.758106047406;9713.174380177765;9716.659916903016;5229.084910140787;5260.10578201699;5260.605454590921;5264.184051472028;5269.1832765921345;4739.928901066487;4760.143174228603;4776.808927642925;4812.783424745895;4815.133276010281;3311.304626028561;3875.1668391296007;3877.806109694504;3884.1649045455365;3905.964919296389;1190.9344986025678;1195.6831439668495;1198.556534082395;1203.374245392391;1204.975900482003;1339.4173534512518;1346.7373862096993;1365.5357178559339;1371.8559551247174;1373.0731756064617;7673.232676732394;7807.375409967189;7820.296173344426;7829.960850195713;7834.373250139975;494.06868053719;506.3746273352407;506.5972551821311;506.72130328319275;508.7100352798943;6039.66781826995;6187.102870083812;6195.907061394083;6204.286507051656;6226.1905952225925;9546.18857397115;10192.796144077078;10201.438920859424;10242.283040187265;10298.330608510423;9691.660791872251;10011.299209055296;10068.748281293027;10097.141742951784;10170.644027459004;8046.839063218703;8068.919310806934;8099.757007289791;8125.06561745395;8157.143499932422;7900.723474678359;7960.4825686330205;7982.481138725964;7989.52062876206;7993.960030199812;9024.954875225581;9141.725748227564;9210.677626283048;9259.583318750807;9289;9216.539173041187;9343.906560934576;9578.521073946415;9584.76038099053;9593.472359020321;7393.260673932564;7396;7425.443091768031;7451.441141914486;7477.663505142173;8031.959840200761;8078.272955434039;8083.232092951161;8102.797430064295;8126.309263712651;7441.255874412732;7540.622968851426;7550.433717471322;7658.310752032344;7692.653830577749;7439.479236453396;7450.627468626655;7460.66427010775;7470.775876723707;7508.511946723445;7509.7371591994015;7558.622068896643;7564.810879728051;7573.545587264782;7577.128630207597;6802.897956530755;6841.24746277919;6858.6227757471825;6865.210500792473;6905.516613836983;6980.965095174492;6991.196012458632;7030.015797788416;7038.01467794499;7040.788776336718 16:14:36 INFO - 2015-11-24 16:14:36,325 DEBUG : BROWSER_OUTPUT: |4;prototype.html;323.71351354051666;328.0993672369345;330.7767257101459;331.10931594012106;337.86992008076896;6977.616231107287;7063.470239732022;7091.574505529659;7109.502334836564;7228.891566626505;6912.343327383903;7043.929560704391;7096.183938847034;7099.112610923635;7111.466640001995;4167.687423443239;5129.410117836459;5136.178211486163;5170;5170.508801663855;4918.704877707331;5175.404828444739;5177.249298851664;5182.170852663575;5187.533122019017;4028.4964379452567;4991.32617096691;5009.9749501252445;5013.398392192942;5021.422536408305;4999.500049994989;5011.799528018875;5015.398152221738;5020.447750747415;5029.19532874742;4235.237657221699;4236.872893813191;4242.9787851060855;4256.3189889617515;4263.786810659454;5617.38208797032;6320.546274356923;6761.729530818761;6763.188417389895;6779.423748981342;5972.641641501524;5978.342382337939;5988.341282458926;6005.519558435359;6052.788152414644;7452.292032256927;7457.254274572553;7478.813029674302;7487.213842546563;7490.4756667033325;4630.374899388573;4774.856754297377;4784.832530861438;4790.736509491977;4796.952030479721;7925.8811117833275;8021.438499305051;8063.226090260134;8084.070331911847;8090.312323452514;4846.297286893451;4849.466558678542;4851.56335929768;4854.902901941941;4862.9544647900875;4073.4704488416314;4925.482824303468;4938.703677779273;4938.777755001033;4957.058158949788;4822.590079843252;5807.390224026501;5966.463018328372;5978.790742323998;5983.461488465972;7352.595607241653;7630;7633.313001829862;7662.272084152108;7679.385649148055;1647.1681800690815;1664.2843577261895;1707.5304291319737;1710.3842616657994;1721.7847769028872;1068.5191663751343;1082.226208261097;1087.1574529739514;1095.2880627592128;1099.0493223361893;5918.940810591839;6926.134233220848;6933.895991560131;6935.826604334831;6967.407770339477;7441.330280274693;7744.225577442324;7744.535327880345;7745;7753.030871141107;6850.451963842881;6897;6908.378245957888;6920.30796920304;7177.282271772781;4174.123434078878;4204.66362690984;4208.600182982612;4212.515560710496;4224.091820258659;8237.487566292339;8243.969503812023;8257.752267431986;8268.793280168044;8273.83452330962;8089.352851771844;8250.958745206235;8332.208440198172;8332.416730828783;8339.95830020846;8265.628046737911;8268.669253229924;8298.70954516589;8302.70940517079;8341.708040218684;7764.456488045783;7932.6430310635005;7999.200079992187;8006.8398632025865;8012.799680008046;7836.138024817152;7837.216278372117;7845.725399610987;7851.960740196262;7868.881966770388;8235.423520353517;8260.952133454684;8263.256306932404;8270.917290827256;8298.045724741733;4695.826043489128;4851.078295123915;4861.781219845045;4865.878353041202;4871.293662419001;7575.772726818204;7772.689092436465;7895.526268423913;7899.68401263943;7918.604069796372;6205.937940620536;7488.138864030706;7600.543967361976;7614.334982755991;7660.73187438437;6849.280825513449;7608.391328693802;7646.847063058596;7655.119661239029;7662.540247585162;7187.712491500491;7444.851102978018;7465.850682986418;7471.364933980455;7484.588347640932;6549.934500655123;7257.745978890714;7624.8475030500185;7660.96576962103;7666.9616651916385;6653.935370340722;6866.759663411756;7185.892211616725;7422.257774222535;7483.214262502576 16:14:36 INFO - 2015-11-24 16:14:36,327 DEBUG : BROWSER_OUTPUT: |5;yui.html;669.069992710133;707.3245050976317;713.5326361233391;759.7758661194947;804.3283857978588;14845.554633361004;14968.925155374209;15210.01134926229;15234.771478427805;15270.312835922383;13346.66633334167;16431.91784041078;16659.750103748454;16681.749773753374;16687.415940442086;771.6180490657133;776.974393800184;962.311946957925;966.7341481092703;982.2976571751196;958.4009993753904;961.6489981156863;969.7090872738186;971.03382134776;976.2921881635792;1001.9499025048755;1019.4647809899787;1024.666983230453;1025.9538320775582;1026.7638443158078;995.761017355833;997.8104160209537;1011.0950699124317;1018.404233523386;1019.2915923433217;734.3354264390734;741.8293792427718;745.4707157917885;759.5556599389364;761.7676608634364;15442.150681712501;15513;15518.767218491732;15584;15627.45303914369;11207.775844483147;12358.75282494345;12370.75258494834;12374.690632734253;12446.875531244663;9986.560012790518;10358.067773900386;10405.271630985833;10528.052475277185;10882.891171088268;3493.91265218369;3515.156362473014;3527.453244747043;3578.6421357864265;3590.6588874056924;68731.31268687299;69905.30094699039;70184;83242;84310.15689843084;9485.525723713787;9506.762330941781;9665.178459830853;9756.95121524402;10101.69694909154;21215.36353909385;21398.930053497264;21409.036593353336;21472.24847130343;21522.354329370144;7368.410527157815;7415.221401752846;7442.367398771057;7634.580098094547;7813.531188128731;4069.104796944667;4082.2856000199845;4089.7189562654885;4097.037196258877;4110.77390743506;3508.158042069936;3531.3643544161782;3553.3248682750195;3558.395072837572;3582.265635544707;555.8443635781906;561.7781325616849;646.424682032991;650.4731167754135;659.6075335175562;464.76761619190404;496.1169118968242;496.75162418790603;517.283562266264;527.6201135182662;7006.649667516604;8589.48463092204;8613.446425100896;8616.870746938801;8768.17963880458;543.4266848474817;554.8751530905514;617.7312868902042;621.8227805075531;633.3539789414771;3123.375324935022;3605.7115430765475;3771.4908487354405;4020.3567429211184;4152.335626299778;87852;88594.55702721573;88869;92053;93728;78022;78871.60564197143;84604.57697711595;85547.14452855516;85837.57081214554;76075.61962190154;76356;76450.85323720037;77533.83699244515;78299.60850195713;8959.776005599912;9041.276697864023;9057.77355566116;9144.725658230263;9200.21798147165;54303.45696543142;54586.727066366;54809;54943;55590.444095560146;75813;76313.61843190748;76830;77977.22022779699;78123;10991.780164396827;11122.388268645302;11142.27575207609;11381.203315768147;12037.097217708531;12327.445264962918;12480.438380273092;12771.169873958162;13358.666033349244;13453.798193026916;11612.245204061708;11756.82364764512;12116.454759536018;12296.077794165294;12558.12093153507;11749.950426333464;11980.58067967617;12020.819687704867;12267.631971040882;12660.493580256687;11617.361045142598;12062.939685301868;12063.698407539881;12068;12072.517099316281;9654.613815447303;9847.85642971751;10109.14072303833;10268.178545716175;10814.837777433188;9338.67517673029;9573.952130239304;9711.66009189675;9846.310758246855;10246 16:14:36 INFO - 2015-11-24 16:14:36,327 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:14:36 INFO - 2015-11-24 16:14:36,327 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:14:36 INFO - 2015-11-24 16:14:36,327 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,339 16:14:36 INFO - 2015-11-24 16:14:36,327 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:14:36 INFO - 2015-11-24 16:14:36,327 DEBUG : BROWSER_OUTPUT: __startTimestamp1448410476313__endTimestamp 16:14:36 INFO - 2015-11-24 16:14:36,327 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,327 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:14:36 INFO - 2015-11-24 16:14:36,328 DEBUG : BROWSER_OUTPUT: Number of tests: 6 16:14:36 INFO - 2015-11-24 16:14:36,328 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,329 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5853.99 Median:6101.19 stddev:649.57 (10.6%) stddev-sans-first:623.32 16:14:36 INFO - 2015-11-24 16:14:36,330 DEBUG : BROWSER_OUTPUT: Values: 3438.6 3478.2 3494.4 3532.3 3552.6 5796.8 5924.6 5955.0 5991.2 6020.5 5755.1 5841.4 5867.2 5951.5 5987.2 5274.7 5308.5 5341.0 5371.2 5384.9 5330.0 5359.2 5374.5 5396.6 5420.5 5023.0 5177.5 5183.2 5308.2 5309.3 5274.2 5293.4 5302.0 5331.8 5352.1 5252.1 5277.8 5329.9 5341.3 5369.7 5114.9 5288.5 5618.0 5637.4 5767.7 6302.7 6307.0 6314.5 6329.7 6372.6 6173.0 6342.6 6382.3 6413.4 6415.9 5866.4 5944.1 6016.9 6031.0 6083.7 6428.3 6443.2 6529.6 6545.4 6546.9 6034.0 6214.8 6316.7 6343.5 6354.7 5198.5 6292.2 6304.8 6345.1 6362.0 6284.5 6300.9 6326.7 6343.7 6355.0 6149.6 6150.2 6241.6 6265.3 6295.9 5083.6 5094.0 5101.1 5111.1 5112.6 4569.2 4590.5 4592.6 4605.1 4654.8 5783.1 5800.7 5829.0 5977.9 6050.4 6328.0 6400.5 6444.5 6453.7 6461.6 5989.3 6027.2 6029.4 6031.5 6049.8 4820.7 5368.0 5372.1 5509.4 5512.6 6468.0 6475.2 6508.3 6526.0 6661.1 6203.9 6343.0 6347.6 6354.6 6361.7 5394.9 6296.9 6374.1 6439.4 6439.8 6290.4 6311.2 6320.8 6322.1 6364.3 6154.4 6293.2 6409.3 6436.3 6442.7 5623.6 6005.7 6118.9 6177.4 6224.6 6217.0 6240.6 6301.3 6330.9 6373.7 5810.7 5855.8 6109.8 6184.6 6217.9 6101.2 6160.6 6179.5 6190.9 6205.8 6105.9 6214.3 6223.8 6232.0 6240.2 16:14:36 INFO - 2015-11-24 16:14:36,330 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,330 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:69392.25 Median:41791.08 stddev:144470.95 (345.7%) stddev-sans-first:144783.77 16:14:36 INFO - 2015-11-24 16:14:36,331 DEBUG : BROWSER_OUTPUT: Values: 549.8 582.0 589.5 599.7 632.9 41510.2 42072.0 42119.0 42243.0 42322.4 43252.4 43763.0 43773.8 43776.0 43822.3 9738.7 9844.7 9931.4 9941.7 9949.5 9723.4 9848.6 9863.6 9891.1 9903.0 9797.9 9860.7 9891.6 9903.0 9908.6 8454.5 9798.2 9816.3 9847.9 9875.7 9427.7 9631.0 9786.1 9786.9 9829.4 40690.8 40760.4 40840.4 40996.8 41161.8 3172.0 3279.5 3409.5 3477.4 3530.6 28716.1 29013.0 29359.4 29553.0 29594.7 2757.3 2762.4 2786.9 2972.9 2986.6 499939.0 504085.0 506657.0 506859.0 507148.3 63924.7 65811.0 72198.0 74975.6 77148.6 63829.7 75618.2 75649.6 75938.6 76175.1 16411.8 16446.7 16593.1 16604.7 16619.2 10196.6 12396.0 12405.9 12425.1 12673.4 22734.0 22828.3 22960.4 23052.3 23083.7 9679.7 9882.0 9909.4 9917.1 9946.0 902.8 985.5 987.0 1053.1 1054.3 28788.6 33732.5 34014.7 34294.0 34294.0 1043.7 1068.6 1131.5 1132.6 1163.0 15493.7 15515.0 15628.9 15739.9 15745.2 532520.3 625969.7 650000.0 658510.0 659318.0 62482.7 62901.0 62914.7 63025.4 63061.4 1414.0 1421.9 1443.2 1443.7 1454.8 30206.1 30227.8 30274.7 30488.5 30666.4 53175.7 53523.5 53664.0 53869.0 53942.1 402507.0 500369.0 500510.0 501486.0 507405.0 34008.5 46401.0 47304.8 48838.5 49016.8 39558.6 47152.0 47505.8 47693.5 48737.0 37533.8 38145.2 39622.0 40115.8 40405.4 38628.8 39234.4 39287.4 39940.8 40250.0 38337.6 38748.0 38960.6 38992.0 39143.8 32336.7 34945.0 34959.0 35113.6 35339.3 25813.6 25875.4 25876.4 26190.1 26227.5 16:14:36 INFO - 2015-11-24 16:14:36,331 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,331 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:39163.50 Median:20549.43 stddev:125362.71 (610.1%) stddev-sans-first:125680.40 16:14:36 INFO - 2015-11-24 16:14:36,333 DEBUG : BROWSER_OUTPUT: Values: 290.4 367.8 367.8 368.8 369.3 16619.8 20211.7 20453.3 20523.6 21012.5 17760.0 17840.7 17853.7 20277.2 20575.3 5051.8 6193.7 6205.7 6207.2 6219.7 5685.1 5793.0 5878.6 5889.9 6099.2 5793.7 5849.6 5874.7 6554.2 6558.4 6527.7 6549.4 6571.6 6583.8 6608.4 5309.0 5436.2 5491.6 5510.0 5719.6 12984.3 14425.6 19987.1 20135.1 24474.4 1943.7 2007.3 2040.7 2164.8 2297.0 9757.0 9880.7 9949.0 10082.2 14019.7 1709.6 1713.9 1745.7 1773.5 1820.8 101130.0 101512.0 101968.0 102611.5 104093.0 11207.1 11237.7 11284.7 11331.0 11399.5 12144.0 12415.0 12533.8 13029.3 13045.4 6437.4 8128.7 8220.1 8251.1 8266.4 8313.9 8323.0 8323.3 8324.5 8435.5 4362.5 4364.1 4401.3 4431.1 4463.0 1853.1 1887.7 1890.6 1892.2 1894.5 905.3 948.8 993.5 1001.5 1015.9 15351.0 20598.5 20887.9 21053.0 21195.8 796.3 894.9 899.9 913.2 977.3 9800.9 11505.7 11541.0 11677.8 11713.2 745803.0 750310.0 760682.0 775443.0 778058.0 117256.4 117972.0 119312.0 120367.0 122915.4 1235.8 1239.4 1240.9 1245.2 1256.6 16793.6 18880.3 19105.9 19192.9 19448.4 48582.3 50139.7 50435.0 52030.0 55339.0 64690.0 74057.0 74500.0 74588.3 75114.5 9634.0 9730.0 9788.7 9903.8 9975.0 11875.8 11884.3 19040.9 19559.7 19749.9 15543.8 15619.3 15937.7 16055.8 16060.8 15502.9 15665.8 15834.4 15869.7 16297.3 16268.7 16630.8 17225.8 17305.3 17464.1 9611.0 9867.5 9934.6 10100.6 10159.5 15741.0 15746.5 16055.9 16247.8 16264.3 16:14:36 INFO - 2015-11-24 16:14:36,333 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,333 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5855.27 Median:5654.43 stddev:3050.97 (54.0%) stddev-sans-first:3042.08 16:14:36 INFO - 2015-11-24 16:14:36,334 DEBUG : BROWSER_OUTPUT: Values: 1514.2 1546.8 1899.6 1906.8 1929.0 7598.4 7668.6 8175.1 8632.4 8638.0 8129.3 8288.7 8388.2 8424.2 8447.9 2323.2 2355.7 2361.1 2368.3 2371.1 2355.7 2388.2 2421.6 2428.7 2434.1 2336.4 2347.6 2383.8 2387.6 2391.7 2313.8 2352.4 2372.1 2373.8 2380.2 2383.7 2397.1 2412.1 2419.1 2426.5 8426.2 8475.6 8477.1 8493.3 8503.8 4660.9 5166.9 5225.1 5247.3 5252.3 3206.5 3448.2 3452.8 3482.0 3525.6 894.9 1028.6 1052.0 1056.9 1068.9 9391.9 10962.4 10993.4 11036.4 11087.1 4036.4 4714.2 4741.3 4788.9 4789.6 9648.0 9655.6 9675.8 9713.2 9716.7 5229.1 5260.1 5260.6 5264.2 5269.2 4739.9 4760.1 4776.8 4812.8 4815.1 3311.3 3875.2 3877.8 3884.2 3906.0 1190.9 1195.7 1198.6 1203.4 1205.0 1339.4 1346.7 1365.5 1371.9 1373.1 7673.2 7807.4 7820.3 7830.0 7834.4 494.1 506.4 506.6 506.7 508.7 6039.7 6187.1 6195.9 6204.3 6226.2 9546.2 10192.8 10201.4 10242.3 10298.3 9691.7 10011.3 10068.7 10097.1 10170.6 8046.8 8068.9 8099.8 8125.1 8157.1 7900.7 7960.5 7982.5 7989.5 7994.0 9025.0 9141.7 9210.7 9259.6 9289.0 9216.5 9343.9 9578.5 9584.8 9593.5 7393.3 7396.0 7425.4 7451.4 7477.7 8032.0 8078.3 8083.2 8102.8 8126.3 7441.3 7540.6 7550.4 7658.3 7692.7 7439.5 7450.6 7460.7 7470.8 7508.5 7509.7 7558.6 7564.8 7573.5 7577.1 6802.9 6841.2 6858.6 6865.2 6905.5 6981.0 6991.2 7030.0 7038.0 7040.8 16:14:36 INFO - 2015-11-24 16:14:36,334 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,334 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:6134.15 Median:6923.22 stddev:2034.49 (29.4%) stddev-sans-first:1992.91 16:14:36 INFO - 2015-11-24 16:14:36,335 DEBUG : BROWSER_OUTPUT: Values: 323.7 328.1 330.8 331.1 337.9 6977.6 7063.5 7091.6 7109.5 7228.9 6912.3 7043.9 7096.2 7099.1 7111.5 4167.7 5129.4 5136.2 5170.0 5170.5 4918.7 5175.4 5177.2 5182.2 5187.5 4028.5 4991.3 5010.0 5013.4 5021.4 4999.5 5011.8 5015.4 5020.4 5029.2 4235.2 4236.9 4243.0 4256.3 4263.8 5617.4 6320.5 6761.7 6763.2 6779.4 5972.6 5978.3 5988.3 6005.5 6052.8 7452.3 7457.3 7478.8 7487.2 7490.5 4630.4 4774.9 4784.8 4790.7 4797.0 7925.9 8021.4 8063.2 8084.1 8090.3 4846.3 4849.5 4851.6 4854.9 4863.0 4073.5 4925.5 4938.7 4938.8 4957.1 4822.6 5807.4 5966.5 5978.8 5983.5 7352.6 7630.0 7633.3 7662.3 7679.4 1647.2 1664.3 1707.5 1710.4 1721.8 1068.5 1082.2 1087.2 1095.3 1099.0 5918.9 6926.1 6933.9 6935.8 6967.4 7441.3 7744.2 7744.5 7745.0 7753.0 6850.5 6897.0 6908.4 6920.3 7177.3 4174.1 4204.7 4208.6 4212.5 4224.1 8237.5 8244.0 8257.8 8268.8 8273.8 8089.4 8251.0 8332.2 8332.4 8340.0 8265.6 8268.7 8298.7 8302.7 8341.7 7764.5 7932.6 7999.2 8006.8 8012.8 7836.1 7837.2 7845.7 7852.0 7868.9 8235.4 8261.0 8263.3 8270.9 8298.0 4695.8 4851.1 4861.8 4865.9 4871.3 7575.8 7772.7 7895.5 7899.7 7918.6 6205.9 7488.1 7600.5 7614.3 7660.7 6849.3 7608.4 7646.8 7655.1 7662.5 7187.7 7444.9 7465.9 7471.4 7484.6 6549.9 7257.7 7624.8 7661.0 7667.0 6653.9 6866.8 7185.9 7422.3 7483.2 16:14:36 INFO - 2015-11-24 16:14:36,335 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,335 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:19010.18 Median:522.45 stddev:26571.35 (5085.9%) stddev-sans-first:26610.20 16:14:36 INFO - 2015-11-24 16:14:36,336 DEBUG : BROWSER_OUTPUT: Values: 669.1 707.3 713.5 759.8 804.3 14845.6 14968.9 15210.0 15234.8 15270.3 13346.7 16431.9 16659.8 16681.7 16687.4 771.6 777.0 962.3 966.7 982.3 958.4 961.6 969.7 971.0 976.3 1001.9 1019.5 1024.7 1026.0 1026.8 995.8 997.8 1011.1 1018.4 1019.3 734.3 741.8 745.5 759.6 761.8 15442.2 15513.0 15518.8 15584.0 15627.5 11207.8 12358.8 12370.8 12374.7 12446.9 9986.6 10358.1 10405.3 10528.1 10882.9 3493.9 3515.2 3527.5 3578.6 3590.7 68731.3 69905.3 70184.0 83242.0 84310.2 9485.5 9506.8 9665.2 9757.0 10101.7 21215.4 21398.9 21409.0 21472.2 21522.4 7368.4 7415.2 7442.4 7634.6 7813.5 4069.1 4082.3 4089.7 4097.0 4110.8 3508.2 3531.4 3553.3 3558.4 3582.3 555.8 561.8 646.4 650.5 659.6 464.8 496.1 496.8 517.3 527.6 7006.6 8589.5 8613.4 8616.9 8768.2 543.4 554.9 617.7 621.8 633.4 3123.4 3605.7 3771.5 4020.4 4152.3 87852.0 88594.6 88869.0 92053.0 93728.0 78022.0 78871.6 84604.6 85547.1 85837.6 76075.6 76356.0 76450.9 77533.8 78299.6 8959.8 9041.3 9057.8 9144.7 9200.2 54303.5 54586.7 54809.0 54943.0 55590.4 75813.0 76313.6 76830.0 77977.2 78123.0 10991.8 11122.4 11142.3 11381.2 12037.1 12327.4 12480.4 12771.2 13358.7 13453.8 11612.2 11756.8 12116.5 12296.1 12558.1 11750.0 11980.6 12020.8 12267.6 12660.5 11617.4 12062.9 12063.7 12068.0 12072.5 9654.6 9847.9 10109.1 10268.2 10814.8 9338.7 9574.0 9711.7 9846.3 10246.0 16:14:36 INFO - 2015-11-24 16:14:36,336 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:14:36 INFO - 2015-11-24 16:14:36,336 DEBUG : BROWSER_OUTPUT: 16:14:36 INFO - 2015-11-24 16:14:36,801 INFO : Browser exited with error code: 0 16:14:36 INFO - 2015-11-24 16:14:36,822 INFO : Completed test dromaeo_css (00:18:30) 16:14:36 INFO - 2015-11-24 16:14:36,822 INFO : Starting test kraken 16:14:36 INFO - 2015-11-24 16:14:36,822 DEBUG : operating with platform_type : mac_ 16:14:36 INFO - 2015-11-24 16:14:36,822 INFO : Initialising browser for kraken test... 16:14:36 INFO - 2015-11-24 16:14:36,832 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/tmpT4YbIl/profile http://localhost:50745/getInfo.html 16:14:39 INFO - 2015-11-24 16:14:39,637 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:14:39 INFO - 2015-11-24 16:14:39,637 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:14:39 INFO - 2015-11-24 16:14:39,637 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:14:39 INFO - 2015-11-24 16:14:39,637 DEBUG : BROWSER_OUTPUT: __metrics 16:14:40 INFO - 2015-11-24 16:14:40,271 INFO : Browser initialized. 16:14:40 INFO - 2015-11-24 16:14:40,272 INFO : Running cycle 1/1 for kraken test... 16:14:40 INFO - 2015-11-24 16:14:40,272 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/tmpT4YbIl/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:14:52 INFO - 2015-11-24 16:14:52,157 DEBUG : BROWSER_OUTPUT: RSS: Main: 236474368 16:14:52 INFO - 2015-11-24 16:14:52,158 DEBUG : BROWSER_OUTPUT: 16:14:54 INFO - 2015-11-24 16:14:54,933 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50745/tests/kraken/driver.html?testName=audio-beat-detection) 16:14:55 INFO - 2015-11-24 16:14:55,548 DEBUG : BROWSER_OUTPUT: RSS: Main: 250040320 16:14:55 INFO - 2015-11-24 16:14:55,548 DEBUG : BROWSER_OUTPUT: 16:14:58 INFO - 2015-11-24 16:14:58,297 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50745/tests/kraken/driver.html?testName=audio-dft) 16:14:58 INFO - 2015-11-24 16:14:58,900 DEBUG : BROWSER_OUTPUT: RSS: Main: 259432448 16:14:58 INFO - 2015-11-24 16:14:58,900 DEBUG : BROWSER_OUTPUT: 16:15:02 INFO - 2015-11-24 16:15:02,111 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50745/tests/kraken/driver.html?testName=audio-fft) 16:15:02 INFO - 2015-11-24 16:15:02,693 DEBUG : BROWSER_OUTPUT: RSS: Main: 263516160 16:15:02 INFO - 2015-11-24 16:15:02,693 DEBUG : BROWSER_OUTPUT: 16:15:04 INFO - 2015-11-24 16:15:04,608 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50745/tests/kraken/driver.html?testName=audio-oscillator) 16:15:05 INFO - 2015-11-24 16:15:05,213 DEBUG : BROWSER_OUTPUT: RSS: Main: 263675904 16:15:05 INFO - 2015-11-24 16:15:05,213 DEBUG : BROWSER_OUTPUT: 16:15:07 INFO - 2015-11-24 16:15:07,157 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50745/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:15:07 INFO - 2015-11-24 16:15:07,743 DEBUG : BROWSER_OUTPUT: RSS: Main: 264986624 16:15:07 INFO - 2015-11-24 16:15:07,743 DEBUG : BROWSER_OUTPUT: 16:15:10 INFO - 2015-11-24 16:15:10,570 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50745/tests/kraken/driver.html?testName=imaging-darkroom) 16:15:11 INFO - 2015-11-24 16:15:11,173 DEBUG : BROWSER_OUTPUT: RSS: Main: 264015872 16:15:11 INFO - 2015-11-24 16:15:11,173 DEBUG : BROWSER_OUTPUT: 16:15:13 INFO - 2015-11-24 16:15:13,950 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50745/tests/kraken/driver.html?testName=imaging-desaturate) 16:15:14 INFO - 2015-11-24 16:15:14,543 DEBUG : BROWSER_OUTPUT: RSS: Main: 265871360 16:15:14 INFO - 2015-11-24 16:15:14,544 DEBUG : BROWSER_OUTPUT: 16:15:17 INFO - 2015-11-24 16:15:17,374 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50745/tests/kraken/driver.html?testName=json-parse-financial) 16:15:17 INFO - 2015-11-24 16:15:17,973 DEBUG : BROWSER_OUTPUT: RSS: Main: 264327168 16:15:17 INFO - 2015-11-24 16:15:17,973 DEBUG : BROWSER_OUTPUT: 16:15:19 INFO - 2015-11-24 16:15:19,487 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50745/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:15:20 INFO - 2015-11-24 16:15:20,077 DEBUG : BROWSER_OUTPUT: RSS: Main: 264245248 16:15:20 INFO - 2015-11-24 16:15:20,077 DEBUG : BROWSER_OUTPUT: 16:15:21 INFO - 2015-11-24 16:15:21,821 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50745/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:15:22 INFO - 2015-11-24 16:15:22,449 DEBUG : BROWSER_OUTPUT: RSS: Main: 265543680 16:15:22 INFO - 2015-11-24 16:15:22,449 DEBUG : BROWSER_OUTPUT: 16:15:24 INFO - 2015-11-24 16:15:24,585 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50745/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:15:25 INFO - 2015-11-24 16:15:25,185 DEBUG : BROWSER_OUTPUT: RSS: Main: 265490432 16:15:25 INFO - 2015-11-24 16:15:25,185 DEBUG : BROWSER_OUTPUT: 16:15:27 INFO - 2015-11-24 16:15:27,730 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50745/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:15:28 INFO - 2015-11-24 16:15:28,337 DEBUG : BROWSER_OUTPUT: RSS: Main: 265449472 16:15:28 INFO - 2015-11-24 16:15:28,337 DEBUG : BROWSER_OUTPUT: 16:15:30 INFO - 2015-11-24 16:15:30,789 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50745/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:15:31 INFO - 2015-11-24 16:15:31,394 DEBUG : BROWSER_OUTPUT: RSS: Main: 264892416 16:15:31 INFO - 2015-11-24 16:15:31,394 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,022 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50745/tests/kraken/driver.html?testName=ai-astar) 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: RSS: Main: 266768384 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: |0;ai-astar;118;111;117;150;110;176;107;143;115;167 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;177;122;151;185;151;142;163;153;187;121 16:15:33 INFO - 2015-11-24 16:15:33,284 DEBUG : BROWSER_OUTPUT: |2;audio-dft;191;198;196;200;215;197;192;198;207;197 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |3;audio-fft;63;60;71;103;58;65;89;84;110;55 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;78;76;109;78;77;77;112;76;80;105 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;135;87;87;87;87;87;97;118;86;91 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;117;96;95;98;95;98;95;95;94;104 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;91;92;90;91;90;92;91;134;150;95 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;60;59;58;58;58;58;59;64;59;60 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;65;65;66;64;65;67;66;67;66;68 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;86;86;85;85;83;75;95;111;115;92 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;127;132;126;139;131;133;105;131;125;122 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;136;138;156;149;143;137;140;141;142;139 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;67;67;65;68;65;66;68;67;66;66 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:15:33 INFO - 2015-11-24 16:15:33,285 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,815 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: __startTimestamp1448410533276__endTimestamp 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: Number of tests: 14 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:131.40 Median:130.50 stddev:25.52 (19.6%) stddev-sans-first:26.61 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: Values: 118.0 111.0 117.0 150.0 110.0 176.0 107.0 143.0 115.0 167.0 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:155.20 Median:158.00 stddev:23.38 (14.8%) stddev-sans-first:23.43 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: Values: 177.0 122.0 151.0 185.0 151.0 142.0 163.0 153.0 187.0 121.0 16:15:33 INFO - 2015-11-24 16:15:33,286 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:199.10 Median:198.00 stddev:7.09 (3.6%) stddev-sans-first:6.89 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: Values: 191.0 198.0 196.0 200.0 215.0 197.0 192.0 198.0 207.0 197.0 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:75.80 Median:64.00 stddev:19.59 (30.6%) stddev-sans-first:20.22 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: Values: 63.0 60.0 71.0 103.0 58.0 65.0 89.0 84.0 110.0 55.0 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:86.80 Median:77.00 stddev:15.22 (19.8%) stddev-sans-first:15.81 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: Values: 78.0 76.0 109.0 78.0 77.0 77.0 112.0 76.0 80.0 105.0 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:96.20 Median:87.00 stddev:16.78 (19.3%) stddev-sans-first:10.39 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: Values: 135.0 87.0 87.0 87.0 87.0 87.0 97.0 118.0 86.0 91.0 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,287 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:98.70 Median:95.00 stddev:7.06 (7.4%) stddev-sans-first:3.08 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: Values: 117.0 96.0 95.0 98.0 95.0 98.0 95.0 95.0 94.0 104.0 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:101.60 Median:91.00 stddev:21.67 (23.8%) stddev-sans-first:22.64 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: Values: 91.0 92.0 90.0 91.0 90.0 92.0 91.0 134.0 150.0 95.0 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:59.30 Median:59.00 stddev:1.83 (3.1%) stddev-sans-first:1.92 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: Values: 60.0 59.0 58.0 58.0 58.0 58.0 59.0 64.0 59.0 60.0 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:65.90 Median:66.00 stddev:1.20 (1.8%) stddev-sans-first:1.22 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: Values: 65.0 65.0 66.0 64.0 65.0 67.0 66.0 67.0 66.0 68.0 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:91.30 Median:85.50 stddev:12.62 (14.8%) stddev-sans-first:13.24 16:15:33 INFO - 2015-11-24 16:15:33,288 DEBUG : BROWSER_OUTPUT: Values: 86.0 86.0 85.0 85.0 83.0 75.0 95.0 111.0 115.0 92.0 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:127.10 Median:131.00 stddev:9.13 (7.0%) stddev-sans-first:9.69 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: Values: 127.0 132.0 126.0 139.0 131.0 133.0 105.0 131.0 125.0 122.0 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:142.10 Median:141.50 stddev:6.12 (4.3%) stddev-sans-first:6.08 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: Values: 136.0 138.0 156.0 149.0 143.0 137.0 140.0 141.0 142.0 139.0 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.50 Median:67.00 stddev:1.08 (1.6%) stddev-sans-first:1.13 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: Values: 67.0 67.0 65.0 68.0 65.0 66.0 68.0 67.0 66.0 66.0 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:15:33 INFO - 2015-11-24 16:15:33,289 DEBUG : BROWSER_OUTPUT: 16:15:33 INFO - 2015-11-24 16:15:33,900 INFO : Browser exited with error code: 0 16:15:33 INFO - 2015-11-24 16:15:33,945 INFO : Completed test kraken (00:00:57) 16:15:33 INFO - 2015-11-24 16:15:33,946 INFO : Starting test v8_7 16:15:33 INFO - 2015-11-24 16:15:33,946 DEBUG : operating with platform_type : mac_ 16:15:33 INFO - 2015-11-24 16:15:33,946 INFO : Initialising browser for v8_7 test... 16:15:33 INFO - 2015-11-24 16:15:33,957 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/tmpqGOYtv/profile http://localhost:50745/getInfo.html 16:15:36 INFO - 2015-11-24 16:15:36,764 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:15:36 INFO - 2015-11-24 16:15:36,764 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:15:36 INFO - 2015-11-24 16:15:36,764 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:15:36 INFO - 2015-11-24 16:15:36,764 DEBUG : BROWSER_OUTPUT: __metrics 16:15:37 INFO - 2015-11-24 16:15:37,352 INFO : Browser initialized. 16:15:37 INFO - 2015-11-24 16:15:37,353 INFO : Running cycle 1/1 for v8_7 test... 16:15:37 INFO - 2015-11-24 16:15:37,353 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/tmpqGOYtv/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:15:49 INFO - 2015-11-24 16:15:49,241 DEBUG : BROWSER_OUTPUT: RSS: Main: 237596672 16:15:49 INFO - 2015-11-24 16:15:49,241 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,688 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50745/tests/v8_7/run.html (next: http://localhost:50745/tests/v8_7/run.html) 16:16:10 INFO - 2015-11-24 16:16:10,946 DEBUG : BROWSER_OUTPUT: RSS: Main: 247754752 16:16:10 INFO - 2015-11-24 16:16:10,946 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,946 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:16:10 INFO - 2015-11-24 16:16:10,946 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:16:10 INFO - 2015-11-24 16:16:10,946 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |0;Richards;179.21146953405017 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;159.23566878980893 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |2;Encrypt;285.7142857142857 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |3;Decrypt;4799.043062200957 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |4;RayTrace;938.0863039399625 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |5;Earley;720.4610951008646 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |6;Boyer;12721.518987341773 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |7;RegExp;26973.684210526317 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |8;Splay;750.561797752809 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4518.018018018018 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: __startTimestamp1448410570940__endTimestamp 16:16:10 INFO - 2015-11-24 16:16:10,947 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: Number of tests: 10 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:179.21 Median:179.21 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: Values: 179.2 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:159.24 Median:159.24 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: Values: 159.2 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:285.71 Median:285.71 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: Values: 285.7 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:4799.04 Median:4799.04 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: Values: 4799.0 16:16:10 INFO - 2015-11-24 16:16:10,948 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:938.09 Median:938.09 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: Values: 938.1 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:720.46 Median:720.46 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: Values: 720.5 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12721.52 Median:12721.52 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: Values: 12721.5 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26973.68 Median:26973.68 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: Values: 26973.7 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:750.56 Median:750.56 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: Values: 750.6 16:16:10 INFO - 2015-11-24 16:16:10,949 DEBUG : BROWSER_OUTPUT: 16:16:10 INFO - 2015-11-24 16:16:10,950 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4518.02 Median:4518.02 stddev:0.00 (0.0%) 16:16:10 INFO - 2015-11-24 16:16:10,950 DEBUG : BROWSER_OUTPUT: Values: 4518.0 16:16:10 INFO - 2015-11-24 16:16:10,950 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:16:10 INFO - 2015-11-24 16:16:10,950 DEBUG : BROWSER_OUTPUT: 16:16:11 INFO - 2015-11-24 16:16:11,726 INFO : Browser exited with error code: 0 16:16:11 INFO - 2015-11-24 16:16:11,744 INFO : Completed test v8_7 (00:00:37) 16:16:11 INFO - 2015-11-24 16:16:11,974 INFO : Completed test suite (00:20:05) 16:16:11 INFO - 2015-11-24 16:16:11,975 DEBUG : Working with test: dromaeo_css 16:16:11 INFO - 2015-11-24 16:16:11,975 DEBUG : Generating results file: dromaeo_css 16:16:11 INFO - 2015-11-24 16:16:11,976 DEBUG : Working with test: kraken 16:16:11 INFO - 2015-11-24 16:16:11,976 DEBUG : Generating results file: kraken 16:16:11 INFO - 2015-11-24 16:16:11,976 INFO : javascript benchmark 16:16:11 INFO - 2015-11-24 16:16:11,976 DEBUG : Working with test: v8_7 16:16:11 INFO - 2015-11-24 16:16:11,976 DEBUG : Generating results file: v8_7 16:16:11 INFO - 2015-11-24 16:16:11,976 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:16:12 INFO - 2015-11-24 16:16:12,567 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,61]] 16:16:12 INFO - 2015-11-24 16:16:12,568 DEBUG : process_Request line: dromaeo_css 7781.35 graph.html#tests=[[72,64,61]] 16:16:12 INFO - 2015-11-24 16:16:12,568 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:16:12 INFO - 2015-11-24 16:16:12,676 DEBUG : process_Request line: kraken 1497.00 graph.html#tests=[[232,64,61]] 16:16:12 INFO - 2015-11-24 16:16:12,676 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:16:12 INFO - 2015-11-24 16:16:12,779 DEBUG : process_Request line: v8_7 21417.02 graph.html#tests=[[230,64,61]] 16:16:12 INFO - 2015-11-24 16:16:12,780 INFO : javascript benchmark 16:16:12 INFO - 2015-11-24 16:16:12,782 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3438.6389429109945, 3478.2347883465627, 3494.4234201356776, 3532.311199316131, 3552.6447355264468, 5796.768129274824, 5924.585279030464, 5954.950027348222, 5991.161237426758, 6020.488258498022, 5755.0504166812425, 5841.415858414157, 5867.207926929863, 5951.494122999539, 5987.161797348374, 5274.683518988863, 5308.522232999029, 5341.0, 5371.248025276464, 5384.892302153955, 5329.973350133244, 5359.16932875403, 5374.516293533581, 5396.622236443451, 5420.539254163401, 5022.974885125587, 5177.534021938006, 5183.196604526267, 5308.177232528964, 5309.283246761695, 5274.182501712241, 5293.3647962244395, 5301.973490132563, 5331.813386531491, 5352.143657014898, 5252.054630166568, 5277.762500687479, 5329.866753331159, 5341.252224688546, 5369.650972686802, 5114.872128196787, 5288.519214619912, 5618.0, 5637.3517045539875, 5767.682777447239, 6302.684865756693, 6306.9684651576445, 6314.494840412756, 6329.746810127589, 6372.553921225516, 6172.969135154295, 6342.556021078526, 6382.266039405435, 6413.390727880844, 6415.93584064158, 5866.384029676865, 5944.108383742473, 6016.939830601638, 6030.969845150747, 6083.695815209177, 6428.325025872309, 6443.162388889508, 6529.608223506605, 6545.410913017851, 6546.9017964730565, 6034.0, 6214.751409943552, 6316.747330106836, 6343.524235682342, 6354.745810167541, 5198.532132108128, 6292.2134733158355, 6304.810855674337, 6345.07996340528, 6362.045693145972, 6284.497240220771, 6300.873982520324, 6326.652034138075, 6343.714532846033, 6355.046742988497, 6149.600275982047, 6150.169727086875, 6241.563090583615, 6265.310815810257, 6295.874082518324, 5083.593312535062, 5093.974530127326, 5101.107306221471, 5111.080005599028, 5112.6421150519855, 4569.177548041384, 4590.472095708969, 4592.632589392841, 4605.125026245003, 4654.790534425959, 5783.103618939072, 5800.6809625471005, 5829.0, 5977.880442391215, 6050.42520960508, 6328.0, 6400.519961002943, 6444.516661250425, 6453.677316134174, 6461.61230326182, 5989.251343582052, 6027.21646185993, 6029.3970602940235, 6031.5476339273855, 6049.818505444844, 4820.662553621213, 5368.033753924331, 5372.059889519397, 5509.3664228613425, 5512.641678290898, 6468.0, 6475.18078986696, 6508.284088750233, 6526.0, 6661.134052573135, 6203.937960620336, 6343.048542718445, 6347.5556711029785, 6354.555181137276, 6361.745530178741, 5394.865128371822, 6296.937030629635, 6374.1394911688185, 6439.420452159328, 6439.774607888701, 6290.370962903673, 6311.2426508819235, 6320.810375688737, 6322.0516922462, 6364.268109167505, 6154.353792851865, 6293.213348331458, 6409.2949775525585, 6436.324185960594, 6442.677866106582, 5623.606347555632, 6005.699715014319, 6118.877622447615, 6177.382261773787, 6224.595401298901, 6217.036359364306, 6240.58018593421, 6301.338359472189, 6330.873382532415, 6373.681315934277, 5810.7094645266725, 5855.765769369348, 6109.755609775737, 6184.5980011299125, 6217.937820621736, 6101.186783078283, 6160.630362178284, 6179.5056395489155, 6190.907136392868, 6205.751769929152, 6105.908411373922, 6214.347493513297, 6223.813285601439, 6231.9688401557705, 6240.219972503437], "unit": "ms", "name": "dojo.html", "value": 5813.805082036337}, {"lowerIsBetter": false, "replicates": [549.7663493015467, 582.0047718401534, 589.4753669234385, 599.7241269016253, 632.8987362022077, 41510.16979660405, 42072.0, 42119.0, 42243.0, 42322.365164522555, 43252.3512147318, 43763.0, 43773.78113109438, 43776.0, 43822.34266485997, 9738.707838764849, 9844.655437059704, 9931.404115753041, 9941.701748947544, 9949.452780097092, 9723.416595004286, 9848.606055757797, 9863.556139973718, 9891.109800117987, 9902.950485247564, 9797.902020979805, 9860.654877079303, 9891.604335826594, 9903.009699030112, 9908.603655853793, 8454.535000574966, 9798.216142708601, 9816.263780216512, 9847.90152098477, 9875.654352097677, 9427.67003154893, 9630.98874618162, 9786.1192492676, 9786.853197202048, 9829.3610915291, 40690.79654601708, 40760.38859417111, 40840.387394188816, 40996.79501602473, 41161.794191029156, 3172.0483854843687, 3279.4916787897914, 3409.539712138879, 3477.3914564951033, 3530.6116327203986, 28716.13851584456, 29013.0, 29359.41281174386, 29553.0, 29594.70405295941, 2757.2831063923322, 2762.4475104978883, 2786.879522819196, 2972.8513574321414, 2986.641603007631, 499939.0, 504085.0, 506656.99999999633, 506859.0, 507148.32129196695, 63924.68037659782, 65811.0, 72198.0, 74975.62512187404, 77148.61425692835, 63829.68085159637, 75618.21908904533, 75649.62175189199, 75938.62030689922, 76175.14423701783, 16411.753823692656, 16446.6710665786, 16593.087380194203, 16604.67162626987, 16619.169041548117, 10196.592136314614, 12396.0, 12405.875941240653, 12425.068119891044, 12673.429695663717, 22734.0, 22828.31515054551, 22960.425989350068, 23052.308430747104, 23083.653745193835, 9679.66121185755, 9882.0, 9909.355891867006, 9917.107460328605, 9946.0, 902.8104098139333, 985.4875464758286, 986.9851952220722, 1053.146950969717, 1054.2988912373187, 28788.568171477444, 33732.49401258983, 34014.659853401645, 34294.0, 34294.0, 1043.6660268713938, 1068.6420049283577, 1131.462555286249, 1132.6262333429947, 1162.976740465186, 15493.690126197413, 15515.0, 15628.857118585755, 15739.921300393426, 15745.212739362985, 532520.3373983105, 625969.7403025911, 650000.0, 658510.0, 659318.0, 62482.68758656178, 62901.0, 62914.68542657257, 63025.369746302866, 63061.36938630647, 1413.964650883736, 1421.85070567591, 1443.2422977936667, 1443.7040406716599, 1454.832694240176, 30206.09381718552, 30227.79088836422, 30274.69725302719, 30488.542671859497, 30666.386672266875, 53175.734121329144, 53523.464765353405, 53664.0, 53868.999999998436, 53942.112026078896, 402507.0, 500369.0, 500510.0, 501486.0, 507405.0, 34008.48987265144, 46401.0, 47304.7634761824, 48838.5116148834, 49016.75491622519, 39558.604413956644, 47152.0, 47505.812354690024, 47693.5230647703, 48737.0, 37533.81233093817, 38145.2370952585, 39622.0, 40115.79942100271, 40405.393919090646, 38628.80685596554, 39234.411483828335, 39287.41068884026, 39940.800295998335, 40249.99375015648, 38337.616623833404, 38748.0, 38960.610393895695, 38992.0, 39143.80428097841, 32336.676633234307, 34945.0, 34959.0, 35113.648863511036, 35339.29321413609, 25813.615360101885, 25875.353116171493, 25876.35309117287, 26190.08334708276, 26227.475450491263], "unit": "ms", "name": "ext.html", "value": 20963.32233871151}, {"lowerIsBetter": false, "replicates": [290.4293064128986, 367.7683059672406, 367.77014366021234, 368.8008475423272, 369.33519664603705, 16619.83380166201, 20211.696824547642, 20453.284135055277, 20523.589528209428, 21012.474688132803, 17760.0, 17840.732389014174, 17853.7321940171, 20277.188912443486, 20575.27986520472, 5051.823186188484, 6193.6593487358405, 6205.689715514229, 6207.162033125538, 6219.720112594921, 5685.118806584966, 5793.044147715622, 5878.617889837147, 5889.911651325234, 6099.237595300588, 5793.739281732311, 5849.64902105875, 5874.70626468677, 6554.246261679897, 6558.409743123118, 6527.673616319189, 6549.410553050248, 6571.638559879205, 6583.802485925406, 6608.372204640552, 5309.0, 5436.238926550286, 5491.643043202179, 5510.035743744828, 5719.598698318897, 12984.28586427746, 14425.567232983027, 19987.10058047377, 20135.0939207736, 24474.388140296458, 1943.6598595245916, 2007.2874129684044, 2040.734704488407, 2164.8159906407973, 2296.9655455168186, 9757.024297570257, 9880.654177103766, 9948.955359687201, 10082.24383171265, 14019.71960560783, 1709.623882745794, 1713.9314427422887, 1745.6683230186225, 1773.485689150158, 1820.8490687600931, 101130.0, 101512.0, 101968.0, 102611.48694256555, 104093.0, 11207.103431725442, 11237.71905702364, 11284.71788205285, 11331.0, 11399.544018239178, 12144.02847772176, 12415.0, 12533.811992820116, 13029.348532573333, 13045.412956416794, 6437.356264373619, 8128.715494957648, 8220.05469371018, 8251.133630968781, 8266.380021498411, 8313.916860831436, 8323.042850072197, 8323.292520135856, 8324.542150181676, 8435.536045517556, 4362.520122786491, 4364.10535840152, 4401.295792673221, 4431.135928493977, 4462.973516091252, 1853.1197681101369, 1887.6602211602044, 1890.5840715042668, 1892.1579896946002, 1894.535838719495, 905.316486053039, 948.83869742144, 993.513178542509, 1001.4892404873567, 1015.9085682288481, 15351.002184857949, 20598.485037873874, 20887.895560522404, 21053.0, 21195.78804211969, 796.3469954637142, 894.9015608283083, 899.9325050621229, 913.2237598041611, 977.3354119198871, 9800.852987205197, 11505.654830355103, 11541.019013383957, 11677.766444671059, 11713.18007739467, 745803.0, 750310.0, 760682.0, 775443.0, 778058.0, 117256.41371793086, 117972.0, 119312.0, 120367.0, 122915.3854230741, 1235.7837378458735, 1239.4050855589367, 1240.8573014103495, 1245.2466257914014, 1256.6418570707306, 16793.580160495596, 18880.33918812835, 19105.94917279563, 19192.904035480293, 19448.41654750303, 48582.27126593033, 50139.74930125326, 50435.0, 52030.0, 55339.0, 64690.0, 74057.0, 74500.0, 74588.25411745813, 75114.4977100444, 9633.951830240803, 9729.951350243204, 9788.706338809847, 9903.801923961337, 9975.0, 11875.76248475043, 11884.286942783461, 19040.905500394667, 19559.70660440066, 19749.901250493655, 15543.84456155424, 15619.297131629331, 15937.68124637524, 16055.759163612789, 16060.839391606401, 15502.9224853875, 15665.765013524579, 15834.366625335319, 15869.682606347578, 16297.26662300223, 16268.67462650764, 16630.806603539928, 17225.827741722424, 17305.30778768835, 17464.12679366052, 9611.038896110333, 9867.457289849128, 9934.552945117632, 10100.595976161165, 10159.492025398553, 15740.97683650559, 15746.527604171893, 16055.919720401324, 16247.837521625106, 16264.349426022827], "unit": "ms", "name": "jquery.html", "value": 9996.149165576177}, {"lowerIsBetter": false, "replicates": [1514.2428785607196, 1546.8221154567227, 1899.5820919397727, 1906.8273012097557, 1928.990355048225, 7598.354139898115, 7668.578228197461, 8175.100738918722, 8632.39573229874, 8638.049814520406, 8129.268365847072, 8288.70989515367, 8388.203120703538, 8424.157584241573, 8447.873281900776, 2323.163661082009, 2355.693759811231, 2361.055577768898, 2368.2895131460577, 2371.122684606698, 2355.7290911545133, 2388.235764555343, 2421.5641184586766, 2428.7085549734056, 2434.075051480435, 2336.3691803213205, 2347.6361164019604, 2383.84505007174, 2387.582173119697, 2391.7129944406697, 2313.7686231376897, 2352.3531028967086, 2372.146027430124, 2373.8100951923893, 2380.1550449590404, 2383.7377888432256, 2397.1490121006964, 2412.0954642009247, 2419.0928401849305, 2426.478307163968, 8426.241638252586, 8475.576221188978, 8477.067522572512, 8493.320534357299, 8503.787405314855, 4660.906781864378, 5166.870828229286, 5225.111731005738, 5247.291615631917, 5252.290940722992, 3206.5350524173864, 3448.1724386147393, 3452.8100954447495, 3482.0250329907667, 3525.6121826599056, 894.9015608283083, 1028.619410818002, 1051.9579216831316, 1056.9324981768393, 1068.8984546468073, 9391.90608093924, 10962.397068161248, 10993.395363255018, 11036.392998385085, 11087.113030957504, 4036.354183330653, 4714.175019371596, 4741.312509686076, 4788.904221915543, 4789.640776941744, 9647.986961368955, 9655.613775448903, 9675.758106047406, 9713.174380177765, 9716.659916903016, 5229.084910140787, 5260.10578201699, 5260.605454590921, 5264.184051472028, 5269.1832765921345, 4739.928901066487, 4760.143174228603, 4776.808927642925, 4812.783424745895, 4815.133276010281, 3311.304626028561, 3875.1668391296007, 3877.806109694504, 3884.1649045455365, 3905.964919296389, 1190.9344986025678, 1195.6831439668495, 1198.556534082395, 1203.374245392391, 1204.975900482003, 1339.4173534512518, 1346.7373862096993, 1365.5357178559339, 1371.8559551247174, 1373.0731756064617, 7673.232676732394, 7807.375409967189, 7820.296173344426, 7829.960850195713, 7834.373250139975, 494.06868053719, 506.3746273352407, 506.5972551821311, 506.72130328319275, 508.7100352798943, 6039.66781826995, 6187.102870083812, 6195.907061394083, 6204.286507051656, 6226.1905952225925, 9546.18857397115, 10192.796144077078, 10201.438920859424, 10242.283040187265, 10298.330608510423, 9691.660791872251, 10011.299209055296, 10068.748281293027, 10097.141742951784, 10170.644027459004, 8046.839063218703, 8068.919310806934, 8099.757007289791, 8125.06561745395, 8157.143499932422, 7900.723474678359, 7960.4825686330205, 7982.481138725964, 7989.52062876206, 7993.960030199812, 9024.954875225581, 9141.725748227564, 9210.677626283048, 9259.583318750807, 9289.0, 9216.539173041187, 9343.906560934576, 9578.521073946415, 9584.76038099053, 9593.472359020321, 7393.260673932564, 7396.0, 7425.443091768031, 7451.441141914486, 7477.663505142173, 8031.959840200761, 8078.272955434039, 8083.232092951161, 8102.797430064295, 8126.309263712651, 7441.255874412732, 7540.622968851426, 7550.433717471322, 7658.310752032344, 7692.653830577749, 7439.479236453396, 7450.627468626655, 7460.66427010775, 7470.775876723707, 7508.511946723445, 7509.7371591994015, 7558.622068896643, 7564.810879728051, 7573.545587264782, 7577.128630207597, 6802.897956530755, 6841.24746277919, 6858.6227757471825, 6865.210500792473, 6905.516613836983, 6980.965095174492, 6991.196012458632, 7030.015797788416, 7038.01467794499, 7040.788776336718], "unit": "ms", "name": "mootools.html", "value": 4712.833998477855}, {"lowerIsBetter": false, "replicates": [323.71351354051666, 328.0993672369345, 330.7767257101459, 331.10931594012106, 337.86992008076896, 6977.616231107287, 7063.470239732022, 7091.574505529659, 7109.502334836564, 7228.891566626505, 6912.343327383903, 7043.929560704391, 7096.183938847034, 7099.112610923635, 7111.466640001995, 4167.687423443239, 5129.410117836459, 5136.178211486163, 5170.0, 5170.508801663855, 4918.704877707331, 5175.404828444739, 5177.249298851664, 5182.170852663575, 5187.533122019017, 4028.4964379452567, 4991.32617096691, 5009.9749501252445, 5013.398392192942, 5021.422536408305, 4999.500049994989, 5011.799528018875, 5015.398152221738, 5020.447750747415, 5029.19532874742, 4235.237657221699, 4236.872893813191, 4242.9787851060855, 4256.3189889617515, 4263.786810659454, 5617.38208797032, 6320.546274356923, 6761.729530818761, 6763.188417389895, 6779.423748981342, 5972.641641501524, 5978.342382337939, 5988.341282458926, 6005.519558435359, 6052.788152414644, 7452.292032256927, 7457.254274572553, 7478.813029674302, 7487.213842546563, 7490.4756667033325, 4630.374899388573, 4774.856754297377, 4784.832530861438, 4790.736509491977, 4796.952030479721, 7925.8811117833275, 8021.438499305051, 8063.226090260134, 8084.070331911847, 8090.312323452514, 4846.297286893451, 4849.466558678542, 4851.56335929768, 4854.902901941941, 4862.9544647900875, 4073.4704488416314, 4925.482824303468, 4938.703677779273, 4938.777755001033, 4957.058158949788, 4822.590079843252, 5807.390224026501, 5966.463018328372, 5978.790742323998, 5983.461488465972, 7352.595607241653, 7630.0, 7633.313001829862, 7662.272084152108, 7679.385649148055, 1647.1681800690815, 1664.2843577261895, 1707.5304291319737, 1710.3842616657994, 1721.7847769028872, 1068.5191663751343, 1082.226208261097, 1087.1574529739514, 1095.2880627592128, 1099.0493223361893, 5918.940810591839, 6926.134233220848, 6933.895991560131, 6935.826604334831, 6967.407770339477, 7441.330280274693, 7744.225577442324, 7744.535327880345, 7745.0, 7753.030871141107, 6850.451963842881, 6897.0, 6908.378245957888, 6920.30796920304, 7177.282271772781, 4174.123434078878, 4204.66362690984, 4208.600182982612, 4212.515560710496, 4224.091820258659, 8237.487566292339, 8243.969503812023, 8257.752267431986, 8268.793280168044, 8273.83452330962, 8089.352851771844, 8250.958745206235, 8332.208440198172, 8332.416730828783, 8339.95830020846, 8265.628046737911, 8268.669253229924, 8298.70954516589, 8302.70940517079, 8341.708040218684, 7764.456488045783, 7932.6430310635005, 7999.200079992187, 8006.8398632025865, 8012.799680008046, 7836.138024817152, 7837.216278372117, 7845.725399610987, 7851.960740196262, 7868.881966770388, 8235.423520353517, 8260.952133454684, 8263.256306932404, 8270.917290827256, 8298.045724741733, 4695.826043489128, 4851.078295123915, 4861.781219845045, 4865.878353041202, 4871.293662419001, 7575.772726818204, 7772.689092436465, 7895.526268423913, 7899.68401263943, 7918.604069796372, 6205.937940620536, 7488.138864030706, 7600.543967361976, 7614.334982755991, 7660.73187438437, 6849.280825513449, 7608.391328693802, 7646.847063058596, 7655.119661239029, 7662.540247585162, 7187.712491500491, 7444.851102978018, 7465.850682986418, 7471.364933980455, 7484.588347640932, 6549.934500655123, 7257.745978890714, 7624.8475030500185, 7660.96576962103, 7666.9616651916385, 6653.935370340722, 6866.759663411756, 7185.892211616725, 7422.257774222535, 7483.214262502576], "unit": "ms", "name": "prototype.html", "value": 5443.936021728232}, {"lowerIsBetter": false, "replicates": [669.069992710133, 707.3245050976317, 713.5326361233391, 759.7758661194947, 804.3283857978588, 14845.554633361004, 14968.925155374209, 15210.01134926229, 15234.771478427805, 15270.312835922383, 13346.66633334167, 16431.91784041078, 16659.750103748454, 16681.749773753374, 16687.415940442086, 771.6180490657133, 776.974393800184, 962.311946957925, 966.7341481092703, 982.2976571751196, 958.4009993753904, 961.6489981156863, 969.7090872738186, 971.03382134776, 976.2921881635792, 1001.9499025048755, 1019.4647809899787, 1024.666983230453, 1025.9538320775582, 1026.7638443158078, 995.761017355833, 997.8104160209537, 1011.0950699124317, 1018.404233523386, 1019.2915923433217, 734.3354264390734, 741.8293792427718, 745.4707157917885, 759.5556599389364, 761.7676608634364, 15442.150681712501, 15513.0, 15518.767218491732, 15584.0, 15627.45303914369, 11207.775844483147, 12358.75282494345, 12370.75258494834, 12374.690632734253, 12446.875531244663, 9986.560012790518, 10358.067773900386, 10405.271630985833, 10528.052475277185, 10882.891171088268, 3493.91265218369, 3515.156362473014, 3527.453244747043, 3578.6421357864265, 3590.6588874056924, 68731.31268687299, 69905.30094699039, 70184.0, 83242.0, 84310.15689843084, 9485.525723713787, 9506.762330941781, 9665.178459830853, 9756.95121524402, 10101.69694909154, 21215.36353909385, 21398.930053497264, 21409.036593353336, 21472.24847130343, 21522.354329370144, 7368.410527157815, 7415.221401752846, 7442.367398771057, 7634.580098094547, 7813.531188128731, 4069.104796944667, 4082.2856000199845, 4089.7189562654885, 4097.037196258877, 4110.77390743506, 3508.158042069936, 3531.3643544161782, 3553.3248682750195, 3558.395072837572, 3582.265635544707, 555.8443635781906, 561.7781325616849, 646.424682032991, 650.4731167754135, 659.6075335175562, 464.76761619190404, 496.1169118968242, 496.75162418790603, 517.283562266264, 527.6201135182662, 7006.649667516604, 8589.48463092204, 8613.446425100896, 8616.870746938801, 8768.17963880458, 543.4266848474817, 554.8751530905514, 617.7312868902042, 621.8227805075531, 633.3539789414771, 3123.375324935022, 3605.7115430765475, 3771.4908487354405, 4020.3567429211184, 4152.335626299778, 87852.0, 88594.55702721573, 88869.0, 92053.0, 93728.0, 78022.0, 78871.60564197143, 84604.57697711595, 85547.14452855516, 85837.57081214554, 76075.61962190154, 76356.0, 76450.85323720037, 77533.83699244515, 78299.60850195713, 8959.776005599912, 9041.276697864023, 9057.77355566116, 9144.725658230263, 9200.21798147165, 54303.45696543142, 54586.727066366, 54809.0, 54943.0, 55590.444095560146, 75813.0, 76313.61843190748, 76830.0, 77977.22022779699, 78123.0, 10991.780164396827, 11122.388268645302, 11142.27575207609, 11381.203315768147, 12037.097217708531, 12327.445264962918, 12480.438380273092, 12771.169873958162, 13358.666033349244, 13453.798193026916, 11612.245204061708, 11756.82364764512, 12116.454759536018, 12296.077794165294, 12558.12093153507, 11749.950426333464, 11980.58067967617, 12020.819687704867, 12267.631971040882, 12660.493580256687, 11617.361045142598, 12062.939685301868, 12063.698407539881, 12068.0, 12072.517099316281, 9654.613815447303, 9847.85642971751, 10109.14072303833, 10268.178545716175, 10814.837777433188, 9338.67517673029, 9573.952130239304, 9711.66009189675, 9846.310758246855, 10246.0], "unit": "ms", "name": "yui.html", "value": 7101.418634867371}], "name": "dromaeo_css", "value": 7781.35281571282}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [118.0, 111.0, 117.0, 150.0, 110.0, 176.0, 107.0, 143.0, 115.0, 167.0], "unit": "ms", "name": "ai-astar", "value": 131.4}, {"lowerIsBetter": true, "replicates": [177.0, 122.0, 151.0, 185.0, 151.0, 142.0, 163.0, 153.0, 187.0, 121.0], "unit": "ms", "name": "audio-beat-detection", "value": 155.2}, {"lowerIsBetter": true, "replicates": [191.0, 198.0, 196.0, 200.0, 215.0, 197.0, 192.0, 198.0, 207.0, 197.0], "unit": "ms", "name": "audio-dft", "value": 199.1}, {"lowerIsBetter": true, "replicates": [63.0, 60.0, 71.0, 103.0, 58.0, 65.0, 89.0, 84.0, 110.0, 55.0], "unit": "ms", "name": "audio-fft", "value": 75.8}, {"lowerIsBetter": true, "replicates": [78.0, 76.0, 109.0, 78.0, 77.0, 77.0, 112.0, 76.0, 80.0, 105.0], "unit": "ms", "name": "audio-oscillator", "value": 86.8}, {"lowerIsBetter": true, "replicates": [135.0, 87.0, 87.0, 87.0, 87.0, 87.0, 97.0, 118.0, 86.0, 91.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 96.2}, {"lowerIsBetter": true, "replicates": [117.0, 96.0, 95.0, 98.0, 95.0, 98.0, 95.0, 95.0, 94.0, 104.0], "unit": "ms", "name": "imaging-darkroom", "value": 98.7}, {"lowerIsBetter": true, "replicates": [91.0, 92.0, 90.0, 91.0, 90.0, 92.0, 91.0, 134.0, 150.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 101.6}, {"lowerIsBetter": true, "replicates": [60.0, 59.0, 58.0, 58.0, 58.0, 58.0, 59.0, 64.0, 59.0, 60.0], "unit": "ms", "name": "json-parse-financial", "value": 59.3}, {"lowerIsBetter": true, "replicates": [65.0, 65.0, 66.0, 64.0, 65.0, 67.0, 66.0, 67.0, 66.0, 68.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 65.9}, {"lowerIsBetter": true, "replicates": [86.0, 86.0, 85.0, 85.0, 83.0, 75.0, 95.0, 111.0, 115.0, 92.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 91.3}, {"lowerIsBetter": true, "replicates": [127.0, 132.0, 126.0, 139.0, 131.0, 133.0, 105.0, 131.0, 125.0, 122.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 127.1}, {"lowerIsBetter": true, "replicates": [136.0, 138.0, 156.0, 149.0, 143.0, 137.0, 140.0, 141.0, 142.0, 139.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 142.1}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 65.0, 68.0, 65.0, 66.0, 68.0, 67.0, 66.0, 66.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 66.5}], "name": "kraken", "value": 1496.9999999999998}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [179.21146953405017], "unit": "score", "name": "Richards", "value": 196.98516}, {"lowerIsBetter": false, "replicates": [159.23566878980893], "unit": "score", "name": "DeltaBlue", "value": 415.22103999999996}, {"lowerIsBetter": false, "replicates": [285.7142857142857], "unit": "score", "name": "Encrypt", "value": 931.6335000000004}, {"lowerIsBetter": false, "replicates": [4799.043062200957], "unit": "score", "name": "Decrypt", "value": 55.4654327018943}, {"lowerIsBetter": false, "replicates": [938.0863039399625], "unit": "score", "name": "RayTrace", "value": 788.8282739999999}, {"lowerIsBetter": false, "replicates": [720.4610951008646], "unit": "score", "name": "Earley", "value": 925.050644}, {"lowerIsBetter": false, "replicates": [12721.518987341773], "unit": "score", "name": "Boyer", "value": 52.38863383084579}, {"lowerIsBetter": false, "replicates": [26973.684210526317], "unit": "score", "name": "RegExp", "value": 33.77310243902437}, {"lowerIsBetter": false, "replicates": [750.561797752809], "unit": "score", "name": "Splay", "value": 108.57333832335327}, {"lowerIsBetter": false, "replicates": [4518.018018018018], "unit": "score", "name": "NavierStokes", "value": 328.4626121635092}], "name": "v8_7", "value": 21417.019000355016}]} 16:16:12 INFO - RETURN: dromaeo_css: 7781.35 16:16:12 INFO - RETURN: kraken: 1497.00 16:16:12 INFO - RETURN: v8_7: 21417.02 16:16:12 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,61]]", "result": "21417.02"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,61]]", "result": "1497.00"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,61]]", "result": "7781.35"}}} 16:16:12 INFO - Return code: 0 16:16:12 INFO - # TBPL SUCCESS # 16:16:12 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:16:12 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:16:12 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:16:12 INFO - 2015-11-24 16:16:12.896 screenresolution[2001:24518] starting screenresolution argv=screenresolution get 16:16:12 INFO - 2015-11-24 16:16:12.898 screenresolution[2001:24518] Display 0: 1600x1200x32@60 16:16:12 INFO - 2015-11-24 16:16:12.904 screenresolution[2002:24521] starting screenresolution argv=screenresolution list 16:16:12 INFO - Available Modes on Display 0 16:16:12 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:16:12 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:16:12 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:16:12 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:16:13 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:16:13 INFO - Intel Iris: 16:16:13 INFO - Chipset Model: Intel Iris 16:16:13 INFO - Type: GPU 16:16:13 INFO - Bus: Built-In 16:16:13 INFO - VRAM (Dynamic, Max): 1536 MB 16:16:13 INFO - Vendor: Intel (0x8086) 16:16:13 INFO - Device ID: 0x0a2e 16:16:13 INFO - Revision ID: 0x0009 16:16:13 INFO - Displays: 16:16:13 INFO - Display: 16:16:13 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:16:13 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:16:13 INFO - Display Serial Number: 1600x1200 60 16:16:13 INFO - Main Display: Yes 16:16:13 INFO - Mirror: Off 16:16:13 INFO - Online: Yes 16:16:13 INFO - Rotation: Supported 16:16:13 INFO - Return code: 0 16:16:13 INFO - Running post-action listener: _resource_record_post_action 16:16:13 INFO - Running post-run listener: _resource_record_post_run 16:16:14 INFO - Total resource usage - Wall time: 1237s; CPU: 53.0%; Read bytes: 2674688; Write bytes: 691325952; Read time: 39; Write time: 2024 16:16:14 INFO - install - Wall time: 31s; CPU: 54.0%; Read bytes: 336941568; Write bytes: 336401920; Read time: 26302; Write time: 579 16:16:14 INFO - run-tests - Wall time: 1208s; CPU: 53.0%; Read bytes: 2674688; Write bytes: 344491520; Read time: 39; Write time: 1412 16:16:14 INFO - Running post-run listener: _upload_blobber_files 16:16:14 INFO - Blob upload gear active. 16:16:14 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 16:16:14 INFO - Copying logs to upload dir... 16:16:14 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1279.013326 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 19 secs) (at 2015-11-24 16:16:14.262888) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-24 16:16:14.267837) ========= 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.QydmIq5z2R/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.R6uTyAgDro/Listeners TMPDIR=/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False build_url:https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.009518 build_url: 'https://queue.taskcluster.net/v1/task/IpCFTOznR3e8UePhN9rYIA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.01 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-24 16:16:14.291087) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 16:16:14.291410) ========= 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.QydmIq5z2R/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.R6uTyAgDro/Listeners TMPDIR=/var/folders/10/1x852mss3jl9sjlsx99svtn400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005363 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 16:16:14.340408) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-24 16:16:14.340720) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-24 16:16:14.341106) ========= ========= Total master_lag: 3.53 =========