builder: fx-team_yosemite_test-dromaeojs-e10s slave: t-yosemite-r5-0065 starttime: 1447686686.5 results: success (0) buildid: 20151116053834 builduid: d7943d55d4ce44cdb57aa31495722f6a revision: a642464a44992122f55bbe919db79b93bfec485b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:26.504340) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:26.504817) ========= ========= Started set props: basedir (results: 0, elapsed: 4 secs) (at 2015-11-16 07:11:26.505142) ========= 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.HkIrKdm96l/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.Wnpav1E41p/Listeners TMPDIR=/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006789 basedir: '/builds/slave/test' ========= master_lag: 4.78 ========= ========= Finished set props: basedir (results: 0, elapsed: 4 secs) (at 2015-11-16 07:11:31.290704) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 5 secs) (at 2015-11-16 07:11:31.291208) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 5 secs) (at 2015-11-16 07:11:36.885401) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:36.886047) ========= 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.HkIrKdm96l/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.Wnpav1E41p/Listeners TMPDIR=/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.062886 ========= master_lag: 0.88 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:37.825967) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:37.826345) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:37.826910) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 7 secs) (at 2015-11-16 07:11:37.827271) ========= 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.HkIrKdm96l/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.Wnpav1E41p/Listeners TMPDIR=/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False --2015-11-16 07:11:40-- 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.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.92M=0.001s 2015-11-16 07:11:40 (8.92 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.291202 ========= master_lag: 7.30 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 7 secs) (at 2015-11-16 07:11:45.417578) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:45.417969) ========= 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.HkIrKdm96l/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.Wnpav1E41p/Listeners TMPDIR=/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.108269 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:45.584829) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:45.585246) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev a642464a44992122f55bbe919db79b93bfec485b --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 a642464a44992122f55bbe919db79b93bfec485b --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.HkIrKdm96l/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.Wnpav1E41p/Listeners TMPDIR=/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False 2015-11-16 07:11:45,770 truncating revision to first 12 chars 2015-11-16 07:11:45,770 Setting DEBUG logging. 2015-11-16 07:11:45,770 attempt 1/10 2015-11-16 07:11:45,770 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/a642464a4499?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-16 07:11:46,025 unpacking tar archive at: fx-team-a642464a4499/testing/mozharness/ program finished with exit code 0 elapsedTime=0.548380 ========= master_lag: 0.15 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:46.278757) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:46.279065) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:46.365885) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:46.366362) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-16 07:11:46.366875) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 5 secs) (at 2015-11-16 07:11:46.367219) ========= /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.HkIrKdm96l/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.Wnpav1E41p/Listeners TMPDIR=/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False 07:11:46 INFO - MultiFileLogger online at 20151116 07:11:46 in /builds/slave/test 07:11:46 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 07:11:46 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:11:46 INFO - {'append_to_log': False, 07:11:46 INFO - 'base_work_dir': '/builds/slave/test', 07:11:46 INFO - 'blob_upload_branch': 'Fx-Team', 07:11:46 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:11:46 INFO - 'branch': 'Fx-Team', 07:11:46 INFO - 'buildbot_json_path': 'buildprops.json', 07:11:46 INFO - 'config_files': ('talos/mac_config.py',), 07:11:46 INFO - 'default_actions': ('clobber', 07:11:46 INFO - 'read-buildbot-config', 07:11:46 INFO - 'download-and-extract', 07:11:46 INFO - 'populate-webroot', 07:11:46 INFO - 'create-virtualenv', 07:11:46 INFO - 'install', 07:11:46 INFO - 'run-tests'), 07:11:46 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:11:46 INFO - 'download_minidump_stackwalk': True, 07:11:46 INFO - 'download_symbols': 'ondemand', 07:11:46 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:11:46 INFO - 'tooltool.py': '/tools/tooltool.py', 07:11:46 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:11:46 INFO - '/tools/misc-python/virtualenv.py')}, 07:11:46 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:11:46 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:11:46 INFO - 'installer_path': 'installer.exe', 07:11:46 INFO - 'log_level': 'info', 07:11:46 INFO - 'log_name': 'talos', 07:11:46 INFO - 'log_to_console': True, 07:11:46 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 07:11:46 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 07:11:46 INFO - 'opt_config_files': (), 07:11:46 INFO - 'pip_index': False, 07:11:46 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 07:11:46 INFO - 'cmd': ('bash', 07:11:46 INFO - '-c', 07:11:46 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 07:11:46 INFO - 'enabled': True, 07:11:46 INFO - 'halt_on_failure': False, 07:11:46 INFO - 'name': 'check_screen_resolution'},), 07:11:46 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 07:11:46 INFO - 'cmd': ('bash', 07:11:46 INFO - '-c', 07:11:46 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 07:11:46 INFO - 'enabled': True, 07:11:46 INFO - 'halt_on_failure': False, 07:11:46 INFO - 'name': 'check_screen_resolution'},), 07:11:46 INFO - 'run_cmd_checks_enabled': True, 07:11:46 INFO - 'sps_profile': False, 07:11:46 INFO - 'sps_profile_interval': 0, 07:11:46 INFO - 'suite': 'dromaeojs-e10s', 07:11:46 INFO - 'system_bits': '64', 07:11:46 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:11:46 INFO - 'title': 't-yosemite-r5-0065', 07:11:46 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:11:46 INFO - 'use_talos_json': True, 07:11:46 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:11:46 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:11:46 INFO - 'work_dir': 'build'} 07:11:46 INFO - ##### 07:11:46 INFO - ##### Running clobber step. 07:11:46 INFO - ##### 07:11:46 INFO - Running pre-action listener: _resource_record_pre_action 07:11:46 INFO - Running main action method: clobber 07:11:46 INFO - rmtree: /builds/slave/test/build 07:11:46 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:11:51 INFO - Running post-action listener: _resource_record_post_action 07:11:51 INFO - ##### 07:11:51 INFO - ##### Running read-buildbot-config step. 07:11:51 INFO - ##### 07:11:51 INFO - Running pre-action listener: _resource_record_pre_action 07:11:51 INFO - Running main action method: read_buildbot_config 07:11:51 INFO - Using buildbot properties: 07:11:51 INFO - { 07:11:51 INFO - "properties": { 07:11:51 INFO - "buildnumber": 45, 07:11:51 INFO - "product": "firefox", 07:11:51 INFO - "script_repo_revision": "production", 07:11:51 INFO - "builddir": "fx-team_yosemite_test-dromaeojs-e10s", 07:11:51 INFO - "repository": "", 07:11:51 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 fx-team talos dromaeojs-e10s", 07:11:51 INFO - "buildid": "20151116053834", 07:11:51 INFO - "slavename": "t-yosemite-r5-0065", 07:11:51 INFO - "pgo_build": "False", 07:11:51 INFO - "basedir": "/builds/slave/test", 07:11:51 INFO - "project": "", 07:11:51 INFO - "platform": "yosemite", 07:11:51 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 07:11:51 INFO - "slavebuilddir": "test", 07:11:51 INFO - "scheduler": "tests-fx-team-macosx64-talos", 07:11:51 INFO - "branch": "fx-team", 07:11:51 INFO - "repo_path": "integration/fx-team", 07:11:51 INFO - "stage_platform": "macosx64", 07:11:51 INFO - "builduid": "d7943d55d4ce44cdb57aa31495722f6a", 07:11:51 INFO - "revision": "a642464a44992122f55bbe919db79b93bfec485b" 07:11:51 INFO - }, 07:11:51 INFO - "sourcestamp": { 07:11:51 INFO - "repository": "", 07:11:51 INFO - "hasPatch": false, 07:11:51 INFO - "project": "", 07:11:51 INFO - "branch": "fx-team-macosx64-talos", 07:11:51 INFO - "changes": [ 07:11:51 INFO - { 07:11:51 INFO - "category": null, 07:11:51 INFO - "files": [ 07:11:51 INFO - { 07:11:51 INFO - "url": null, 07:11:51 INFO - "name": "https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 07:11:51 INFO - } 07:11:51 INFO - ], 07:11:51 INFO - "repository": "", 07:11:51 INFO - "rev": "a642464a44992122f55bbe919db79b93bfec485b", 07:11:51 INFO - "who": "pastithas@mozilla.com", 07:11:51 INFO - "when": 1447685246, 07:11:51 INFO - "number": 6665982, 07:11:51 INFO - "comments": "Make 'Go Back' button work even when there is nothing to go back to (bug 1221084); r=paolo\n", 07:11:51 INFO - "project": "", 07:11:51 INFO - "at": "Mon 16 Nov 2015 06:47:26", 07:11:51 INFO - "branch": "fx-team-macosx64-talos", 07:11:51 INFO - "revlink": "", 07:11:51 INFO - "properties": [ 07:11:51 INFO - [ 07:11:51 INFO - "buildid", 07:11:51 INFO - "20151116053834", 07:11:51 INFO - "Change" 07:11:51 INFO - ], 07:11:51 INFO - [ 07:11:51 INFO - "builduid", 07:11:51 INFO - "d7943d55d4ce44cdb57aa31495722f6a", 07:11:51 INFO - "Change" 07:11:51 INFO - ], 07:11:51 INFO - [ 07:11:51 INFO - "pgo_build", 07:11:51 INFO - "False", 07:11:51 INFO - "Change" 07:11:51 INFO - ] 07:11:51 INFO - ], 07:11:51 INFO - "revision": "a642464a44992122f55bbe919db79b93bfec485b" 07:11:51 INFO - } 07:11:51 INFO - ], 07:11:51 INFO - "revision": "a642464a44992122f55bbe919db79b93bfec485b" 07:11:51 INFO - } 07:11:51 INFO - } 07:11:51 INFO - Found installer url https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 07:11:51 INFO - Running post-action listener: _resource_record_post_action 07:11:51 INFO - ##### 07:11:51 INFO - ##### Running download-and-extract step. 07:11:51 INFO - ##### 07:11:51 INFO - Running pre-action listener: _resource_record_pre_action 07:11:51 INFO - Running main action method: download_and_extract 07:11:51 INFO - mkdir: /builds/slave/test/build/tests 07:11:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:51 INFO - https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 07:11:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/test_packages.json 07:11:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/test_packages.json 07:11:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 07:11:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 07:11:51 INFO - Downloaded 1149 bytes. 07:11:51 INFO - Reading from file /builds/slave/test/build/test_packages.json 07:11:51 INFO - Using the following test package requirements: 07:11:51 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 07:11:51 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 07:11:51 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 07:11:51 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 07:11:51 INFO - u'jsshell-mac.zip'], 07:11:51 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 07:11:51 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 07:11:51 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 07:11:51 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 07:11:51 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 07:11:51 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 07:11:51 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 07:11:51 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 07:11:51 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 07:11:51 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 07:11:51 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 07:11:51 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 07:11:51 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 07:11:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:51 INFO - https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 07:11:52 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 07:11:52 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 07:11:52 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/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 07:11:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/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 07:11:53 INFO - Downloaded 17464047 bytes. 07:11:53 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 07:11:53 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 07:11:53 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 07:11:58 INFO - Return code: 0 07:11:58 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 07:11:58 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')]} 07:11:58 INFO - https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 07:11:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 07:11:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 07:11:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/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 07:11:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/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 07:11:59 INFO - Downloaded 17464047 bytes. 07:11:59 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 07:11:59 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 07:11:59 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 07:12:06 INFO - Return code: 0 07:12: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')]} 07:12:06 INFO - https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 07:12:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 07:12:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 07:12:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/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 07:12:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/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 07:12:06 INFO - Downloaded 11131693 bytes. 07:12: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 07:12:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 07:12:06 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 07:12:07 INFO - Return code: 0 07:12: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')]} 07:12:07 INFO - https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 07:12:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 07:12:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 07:12:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 07:12:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wnpTCeNiTBCBenbBvL0DUw/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 07:12:11 INFO - Downloaded 108681249 bytes. 07:12:11 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 07:12:11 INFO - mkdir: /builds/slave/test/properties 07:12:11 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:12:11 INFO - Writing to file /builds/slave/test/properties/build_url 07:12:11 INFO - Contents: 07:12:11 INFO - build_url:https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 07:12:11 INFO - Running post-action listener: _resource_record_post_action 07:12:11 INFO - Running post-action listener: set_extra_try_arguments 07:12:11 INFO - ##### 07:12:11 INFO - ##### Running populate-webroot step. 07:12:11 INFO - ##### 07:12:11 INFO - Running pre-action listener: _resource_record_pre_action 07:12:11 INFO - Running main action method: populate_webroot 07:12:11 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:12:11 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:12:11 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 07:12:11 INFO - '../fennec_ids.txt'], 07:12:11 INFO - 'tests': ['tcheck2']}, 07:12:11 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:12:11 INFO - '--tppagecycles', 07:12:11 INFO - '7'], 07:12:11 INFO - 'tests': ['tsvgm']}}, 07:12:11 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 07:12:11 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:12:11 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 07:12:11 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 07:12:11 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:12:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:12:11 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:12:11 INFO - 'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:12:11 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:12:11 INFO - 'tests': ['damp', 'tps']}, 07:12:11 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:12:11 INFO - 'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['damp', 'tps']}, 07:12:11 INFO - 'g3': {'tests': ['dromaeo_dom']}, 07:12:11 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:12:11 INFO - 'other': {'tests': ['a11yr', 07:12:11 INFO - 'ts_paint', 07:12:11 INFO - 'tpaint', 07:12:11 INFO - 'sessionrestore', 07:12:11 INFO - 'sessionrestore_no_auto_restore']}, 07:12:11 INFO - 'other-e10s': {'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['a11yr', 07:12:11 INFO - 'ts_paint', 07:12:11 INFO - 'tpaint', 07:12:11 INFO - 'sessionrestore', 07:12:11 INFO - 'sessionrestore_no_auto_restore']}, 07:12:11 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['a11yr', 07:12:11 INFO - 'ts_paint', 07:12:11 INFO - 'tpaint', 07:12:11 INFO - 'sessionrestore', 07:12:11 INFO - 'sessionrestore_no_auto_restore']}, 07:12:11 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['a11yr', 07:12:11 INFO - 'ts_paint', 07:12:11 INFO - 'tpaint', 07:12:11 INFO - 'sessionrestore', 07:12:11 INFO - 'sessionrestore_no_auto_restore']}, 07:12:11 INFO - 'other_l64': {'tests': ['a11yr', 07:12:11 INFO - 'ts_paint', 07:12:11 INFO - 'tpaint', 07:12:11 INFO - 'sessionrestore', 07:12:11 INFO - 'sessionrestore_no_auto_restore']}, 07:12:11 INFO - 'other_nol64': {'tests': ['a11yr', 07:12:11 INFO - 'ts_paint', 07:12:11 INFO - 'tpaint', 07:12:11 INFO - 'sessionrestore', 07:12:11 INFO - 'sessionrestore_no_auto_restore']}, 07:12:11 INFO - 'svgr': {'tests': ['tsvgx', 07:12:11 INFO - 'tsvgr_opacity', 07:12:11 INFO - 'tart', 07:12:11 INFO - 'tscrollx', 07:12:11 INFO - 'cart']}, 07:12:11 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['tsvgx', 07:12:11 INFO - 'tsvgr_opacity', 07:12:11 INFO - 'tart', 07:12:11 INFO - 'tscrollx', 07:12:11 INFO - 'cart']}, 07:12:11 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:12:11 INFO - 'tests': ['tp5o']}, 07:12:11 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:12:11 INFO - 'talos_options': ['--e10s'], 07:12:11 INFO - 'tests': ['tp5o']}, 07:12:11 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:12:11 INFO - 'talos_options': ['--xperf_path', 07:12:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:12:11 INFO - 'tests': ['tp5n']}, 07:12:11 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:12:11 INFO - 'talos_options': ['--e10s', 07:12:11 INFO - '--xperf_path', 07:12:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:12:11 INFO - 'tests': ['tp5n']}}, 07:12:11 INFO - 'talos.zip': {'path': '', 07:12:11 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:12:11 INFO - Running post-action listener: _resource_record_post_action 07:12:11 INFO - ##### 07:12:11 INFO - ##### Running create-virtualenv step. 07:12:11 INFO - ##### 07:12:11 INFO - Running pre-action listener: _resource_record_pre_action 07:12:11 INFO - Running main action method: create_virtualenv 07:12:11 INFO - Creating virtualenv /builds/slave/test/build/venv 07:12:11 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 07:12:11 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:12:11 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:12:11 INFO - Using real prefix '/tools/python27' 07:12:11 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:12:12 INFO - Installing distribute.............................................................................................................................................................................................done. 07:12:16 INFO - Installing pip.................done. 07:12:16 INFO - Return code: 0 07:12:16 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:12:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:12:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:12:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:16 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 0x103bc5490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ba2228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1c15648e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ae89f0>, '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 0x103848db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103adc8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/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.Wnpav1E41p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:12:16 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 07:12:16 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 07:12:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/Render', 07:12:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:12:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:12:16 INFO - 'HOME': '/Users/cltbld', 07:12:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:12:16 INFO - 'LOGNAME': 'cltbld', 07:12:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:16 INFO - 'MOZ_NO_REMOTE': '1', 07:12:16 INFO - 'NO_EM_RESTART': '1', 07:12:16 INFO - 'PAGER': '/bin/cat', 07:12:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:12:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:12:16 INFO - 'PWD': '/builds/slave/test', 07:12:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:12:16 INFO - 'SHELL': '/bin/bash', 07:12:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Wnpav1E41p/Listeners', 07:12:16 INFO - 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', 07:12:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:12:16 INFO - 'USER': 'cltbld', 07:12:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:12:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:12:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:16 INFO - 'XPC_FLAGS': '0x0', 07:12:16 INFO - 'XPC_SERVICE_NAME': '0', 07:12:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 07:12:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:17 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 07:12:17 INFO - Cleaning up... 07:12:17 INFO - Return code: 0 07:12:17 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 07:12: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')]} 07:12:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12: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')]} 07:12:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12: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', '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 0x103bc5490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ba2228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1c15648e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ae89f0>, '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 0x103848db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103adc8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/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.Wnpav1E41p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:12: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', 'psutil>=0.7.1'] in /builds/slave/test/build 07:12: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 psutil>=0.7.1 07:12:17 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/Render', 07:12:17 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:12:17 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:12:17 INFO - 'HOME': '/Users/cltbld', 07:12:17 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:12:17 INFO - 'LOGNAME': 'cltbld', 07:12:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:17 INFO - 'MOZ_NO_REMOTE': '1', 07:12:17 INFO - 'NO_EM_RESTART': '1', 07:12:17 INFO - 'PAGER': '/bin/cat', 07:12:17 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:12:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:12:17 INFO - 'PWD': '/builds/slave/test', 07:12:17 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:12:17 INFO - 'SHELL': '/bin/bash', 07:12:17 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Wnpav1E41p/Listeners', 07:12:17 INFO - 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', 07:12:17 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:12:17 INFO - 'USER': 'cltbld', 07:12:17 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:12:17 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:12:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:17 INFO - 'XPC_FLAGS': '0x0', 07:12:17 INFO - 'XPC_SERVICE_NAME': '0', 07:12:17 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 07:12:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:17 INFO - Downloading/unpacking psutil>=0.7.1 07:12:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:20 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 07:12:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 07:12:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:12:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:12:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:12:20 INFO - Installing collected packages: psutil 07:12:20 INFO - Running setup.py install for psutil 07:12:20 INFO - building 'psutil._psutil_osx' extension 07:12:20 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 07:12:23 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 07:12:23 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 07:12:23 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 07:12:24 INFO - building 'psutil._psutil_posix' extension 07:12:24 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 07:12:24 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 07:12:24 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 07:12:24 INFO - ^ 07:12:24 INFO - 1 warning generated. 07:12:24 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 07:12:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:12:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:12:24 INFO - Successfully installed psutil 07:12:24 INFO - Cleaning up... 07:12:24 INFO - Return code: 0 07:12:24 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 07:12:24 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')]} 07:12:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:24 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')]} 07:12:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:24 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 0x103bc5490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ba2228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1c15648e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ae89f0>, '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 0x103848db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103adc8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/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.Wnpav1E41p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:12:24 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 07:12:24 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 07:12:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/Render', 07:12:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:12:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:12:24 INFO - 'HOME': '/Users/cltbld', 07:12:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:12:24 INFO - 'LOGNAME': 'cltbld', 07:12:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:24 INFO - 'MOZ_NO_REMOTE': '1', 07:12:24 INFO - 'NO_EM_RESTART': '1', 07:12:24 INFO - 'PAGER': '/bin/cat', 07:12:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:12:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:12:24 INFO - 'PWD': '/builds/slave/test', 07:12:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:12:24 INFO - 'SHELL': '/bin/bash', 07:12:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Wnpav1E41p/Listeners', 07:12:24 INFO - 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', 07:12:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:12:24 INFO - 'USER': 'cltbld', 07:12:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:12:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:12:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:24 INFO - 'XPC_FLAGS': '0x0', 07:12:24 INFO - 'XPC_SERVICE_NAME': '0', 07:12:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 07:12:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:25 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:12:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:27 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:12:27 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 07:12:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:12:27 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:12:27 INFO - Installing collected packages: mozsystemmonitor 07:12:27 INFO - Running setup.py install for mozsystemmonitor 07:12:28 INFO - Successfully installed mozsystemmonitor 07:12:28 INFO - Cleaning up... 07:12:28 INFO - Return code: 0 07:12:28 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:12:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:12:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--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 0x103bc5490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ba2228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1c15648e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ae89f0>, '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 0x103848db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103adc8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/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.Wnpav1E41p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:12:28 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 07:12:28 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 07:12:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/Render', 07:12:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:12:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:12:28 INFO - 'HOME': '/Users/cltbld', 07:12:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:12:28 INFO - 'LOGNAME': 'cltbld', 07:12:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:28 INFO - 'MOZ_NO_REMOTE': '1', 07:12:28 INFO - 'NO_EM_RESTART': '1', 07:12:28 INFO - 'PAGER': '/bin/cat', 07:12:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:12:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:12:28 INFO - 'PWD': '/builds/slave/test', 07:12:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:12:28 INFO - 'SHELL': '/bin/bash', 07:12:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Wnpav1E41p/Listeners', 07:12:28 INFO - 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', 07:12:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:12:28 INFO - 'USER': 'cltbld', 07:12:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:12:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:12:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:28 INFO - 'XPC_FLAGS': '0x0', 07:12:28 INFO - 'XPC_SERVICE_NAME': '0', 07:12:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 07:12:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:28 INFO - Downloading/unpacking blobuploader==1.2.4 07:12:28 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 07:12:28 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 07:12:28 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 07:12:28 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 07:12:28 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 07:12:28 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 07:12:31 INFO - Downloading blobuploader-1.2.4.tar.gz 07:12:31 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 07:12:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:12:31 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12:31 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 07:12:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:12:32 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:12:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:32 INFO - Downloading docopt-0.6.1.tar.gz 07:12:32 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 07:12:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:12:32 INFO - Installing collected packages: blobuploader, requests, docopt 07:12:32 INFO - Running setup.py install for blobuploader 07:12:33 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:12:33 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:12:33 INFO - Running setup.py install for requests 07:12:33 INFO - Running setup.py install for docopt 07:12:33 INFO - Successfully installed blobuploader requests docopt 07:12:33 INFO - Cleaning up... 07:12:34 INFO - Return code: 0 07:12:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:12: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')]} 07:12:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12: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')]} 07:12:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:34 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 0x103bc5490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ba2228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1c15648e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ae89f0>, '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 0x103848db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103adc8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/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.Wnpav1E41p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:12:34 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 07:12:34 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 07:12:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/Render', 07:12:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:12:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:12:34 INFO - 'HOME': '/Users/cltbld', 07:12:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:12:34 INFO - 'LOGNAME': 'cltbld', 07:12:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:34 INFO - 'MOZ_NO_REMOTE': '1', 07:12:34 INFO - 'NO_EM_RESTART': '1', 07:12:34 INFO - 'PAGER': '/bin/cat', 07:12:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:12:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:12:34 INFO - 'PWD': '/builds/slave/test', 07:12:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:12:34 INFO - 'SHELL': '/bin/bash', 07:12:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Wnpav1E41p/Listeners', 07:12:34 INFO - 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', 07:12:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:12:34 INFO - 'USER': 'cltbld', 07:12:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:12:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:12:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:34 INFO - 'XPC_FLAGS': '0x0', 07:12:34 INFO - 'XPC_SERVICE_NAME': '0', 07:12:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 07:12:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:12:34 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-B3MNkS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:12:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:12:34 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-rKQG9z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:12:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:12:34 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-j34wlL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:12:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:12:34 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-DNaX09-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:12:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:12:34 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-2ZUTWQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:12:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:12:35 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-jqL4C5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:12:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:12:35 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-RFTE7E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:12:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:12:35 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-1CuPIy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:12:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:12:35 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-jVOt5v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:12:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:12:35 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-pE0W2o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:12:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:12:35 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-scoiYV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:12:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:12:35 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-PL3Jl2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:12:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:12:36 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-Ls833r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:12:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:12:36 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-SKD08O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:12:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:12:36 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-v40t_x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:12:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:12:36 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-UOe7jQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:12:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:12:36 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-bRzgIs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:12:36 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:12:36 INFO - Running setup.py install for manifestparser 07:12:36 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:12:36 INFO - Running setup.py install for mozcrash 07:12:37 INFO - Running setup.py install for mozdebug 07:12:37 INFO - Running setup.py install for mozdevice 07:12:37 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:12:37 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:12:37 INFO - Running setup.py install for mozfile 07:12:37 INFO - Running setup.py install for mozhttpd 07:12:37 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:12:37 INFO - Running setup.py install for mozinfo 07:12:38 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:12:38 INFO - Running setup.py install for mozInstall 07:12:38 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:12:38 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:12:38 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:12:38 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:12:38 INFO - Running setup.py install for mozleak 07:12:38 INFO - Running setup.py install for mozlog 07:12:38 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:12:38 INFO - Running setup.py install for moznetwork 07:12:38 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:12:38 INFO - Running setup.py install for mozprocess 07:12:39 INFO - Running setup.py install for mozprofile 07:12:39 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:12:39 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:12:39 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:12:39 INFO - Running setup.py install for mozrunner 07:12:39 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:12:39 INFO - Running setup.py install for mozscreenshot 07:12:39 INFO - Running setup.py install for moztest 07:12:39 INFO - Running setup.py install for mozversion 07:12:40 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:12:40 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:12:40 INFO - Cleaning up... 07:12:40 INFO - Return code: 0 07:12:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:12:40 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')]} 07:12:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:40 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')]} 07:12:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:40 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 0x103bc5490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ba2228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1c15648e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ae89f0>, '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 0x103848db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103adc8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/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.Wnpav1E41p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:12:40 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 07:12:40 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 07:12:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/Render', 07:12:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:12:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:12:40 INFO - 'HOME': '/Users/cltbld', 07:12:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:12:40 INFO - 'LOGNAME': 'cltbld', 07:12:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:40 INFO - 'MOZ_NO_REMOTE': '1', 07:12:40 INFO - 'NO_EM_RESTART': '1', 07:12:40 INFO - 'PAGER': '/bin/cat', 07:12:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:12:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:12:40 INFO - 'PWD': '/builds/slave/test', 07:12:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:12:40 INFO - 'SHELL': '/bin/bash', 07:12:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Wnpav1E41p/Listeners', 07:12:40 INFO - 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', 07:12:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:12:40 INFO - 'USER': 'cltbld', 07:12:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:12:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:12:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:40 INFO - 'XPC_FLAGS': '0x0', 07:12:40 INFO - 'XPC_SERVICE_NAME': '0', 07:12:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 07:12:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:12:40 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-MDIswe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:12:40 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)) 07:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:12:40 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-wncivM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:12:40 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)) 07:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:12:40 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-LRrCOT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:12:41 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)) 07:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:12:41 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-HCabaO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:12:41 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)) 07:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:12:41 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-SAh1n8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:12:41 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)) 07:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:12:41 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-dKX8Fx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:12:41 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)) 07:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:12:41 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-SGcps0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:12:41 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)) 07:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:12:41 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-5pQsnv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:12:41 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)) 07:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:12:41 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-OfLH_0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:12:41 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)) 07:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:12:41 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-AjdkJp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:12:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:12:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:12:42 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-L5JEtC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:12:42 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)) 07:12:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:12:42 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-1YdPL3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:12:42 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)) 07:12:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:12:42 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-VJZ7vK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:12:42 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)) 07:12:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:12:42 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-KWnPCB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:12:42 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)) 07:12:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:12:42 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-SKa7xx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:12:42 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)) 07:12:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:12:42 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-1RxrwH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:12:42 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)) 07:12:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:12:42 INFO - Running setup.py (path:/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/pip-0_fm1z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:12:43 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)) 07:12:43 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)) 07:12:43 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)) 07:12:43 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)) 07:12:43 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)) 07:12:43 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)) 07:12:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:12:43 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 07:12:43 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 07:12:43 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 07:12:43 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 07:12:43 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 07:12:43 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 07:12:45 INFO - Downloading blessings-1.5.1.tar.gz 07:12:45 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 07:12:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:12:45 INFO - Installing collected packages: blessings 07:12:45 INFO - Running setup.py install for blessings 07:12:46 INFO - Successfully installed blessings 07:12:46 INFO - Cleaning up... 07:12:46 INFO - Return code: 0 07:12:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:12:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:12:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:12:46 INFO - Reading from file tmpfile_stdout 07:12:46 INFO - Current package versions: 07:12:46 INFO - blessings == 1.5.1 07:12:46 INFO - blobuploader == 1.2.4 07:12:46 INFO - docopt == 0.6.1 07:12:46 INFO - manifestparser == 1.1 07:12:46 INFO - mozInstall == 1.12 07:12:46 INFO - mozcrash == 0.16 07:12:46 INFO - mozdebug == 0.1 07:12:46 INFO - mozdevice == 0.47 07:12:46 INFO - mozfile == 1.2 07:12:46 INFO - mozhttpd == 0.7 07:12:46 INFO - mozinfo == 0.9 07:12:46 INFO - mozleak == 0.1 07:12:46 INFO - mozlog == 3.0 07:12:46 INFO - moznetwork == 0.27 07:12:46 INFO - mozprocess == 0.22 07:12:46 INFO - mozprofile == 0.27 07:12:46 INFO - mozrunner == 6.11 07:12:46 INFO - mozscreenshot == 0.1 07:12:46 INFO - mozsystemmonitor == 0.0 07:12:46 INFO - moztest == 0.7 07:12:46 INFO - mozversion == 1.4 07:12:46 INFO - psutil == 3.1.1 07:12:46 INFO - requests == 1.2.3 07:12:46 INFO - wsgiref == 0.1.2 07:12:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:12:46 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')]} 07:12:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:46 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')]} 07:12:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:46 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 0x103bc5490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ba2228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1c15648e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103ae89f0>, '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 0x103848db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103adc8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/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.Wnpav1E41p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:12:46 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 07:12:46 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 07:12:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/Render', 07:12:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:12:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:12:46 INFO - 'HOME': '/Users/cltbld', 07:12:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:12:46 INFO - 'LOGNAME': 'cltbld', 07:12:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:46 INFO - 'MOZ_NO_REMOTE': '1', 07:12:46 INFO - 'NO_EM_RESTART': '1', 07:12:46 INFO - 'PAGER': '/bin/cat', 07:12:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:12:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:12:46 INFO - 'PWD': '/builds/slave/test', 07:12:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:12:46 INFO - 'SHELL': '/bin/bash', 07:12:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Wnpav1E41p/Listeners', 07:12:46 INFO - 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', 07:12:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:12:46 INFO - 'USER': 'cltbld', 07:12:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:12:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:12:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:46 INFO - 'XPC_FLAGS': '0x0', 07:12:46 INFO - 'XPC_SERVICE_NAME': '0', 07:12:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 07:12:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 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)) 07:12:46 INFO - Cleaning up... 07:12:46 INFO - Return code: 0 07:12:46 INFO - Running post-action listener: _resource_record_post_action 07:12:46 INFO - Running post-action listener: _start_resource_monitoring 07:12:47 INFO - Starting resource monitoring. 07:12:47 INFO - ##### 07:12:47 INFO - ##### Running install step. 07:12:47 INFO - ##### 07:12:47 INFO - Running pre-action listener: _resource_record_pre_action 07:12:47 INFO - Running main action method: install 07:12:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:12:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:12:47 INFO - Reading from file tmpfile_stdout 07:12:47 INFO - Detecting whether we're running mozinstall >=1.0... 07:12:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:12:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:12:47 INFO - Reading from file tmpfile_stdout 07:12:47 INFO - Output received: 07:12:47 INFO - Usage: mozinstall [options] installer 07:12:47 INFO - Options: 07:12:47 INFO - -h, --help show this help message and exit 07:12:47 INFO - -d DEST, --destination=DEST 07:12:47 INFO - Directory to install application into. [default: 07:12:47 INFO - "/builds/slave/test"] 07:12:47 INFO - --app=APP Application being installed. [default: firefox] 07:12:47 INFO - mkdir: /builds/slave/test/build/application 07:12:47 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'] 07:12:47 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 07:13:30 INFO - Reading from file tmpfile_stdout 07:13:30 INFO - Output received: 07:13:30 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 07:13:30 INFO - Running post-action listener: _resource_record_post_action 07:13:30 INFO - ##### 07:13:30 INFO - ##### Running run-tests step. 07:13:30 INFO - ##### 07:13:30 INFO - Running pre-action listener: _resource_record_pre_action 07:13:30 INFO - Running main action method: run_tests 07:13:30 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 07:13:30 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 07:13:30 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 07:13:30 INFO - 2015-11-16 07:13:30.655 screenresolution[1642:8030] starting screenresolution argv=screenresolution get 07:13:30 INFO - 2015-11-16 07:13:30.659 screenresolution[1642:8030] Display 0: 1600x1200x32@60 07:13:30 INFO - 2015-11-16 07:13:30.666 screenresolution[1643:8032] starting screenresolution argv=screenresolution list 07:13:30 INFO - Available Modes on Display 0 07:13:30 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 07:13:30 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 07:13:30 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 07:13:30 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 07:13:30 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 07:13:30 INFO - Intel HD Graphics 3000: 07:13:30 INFO - Chipset Model: Intel HD Graphics 3000 07:13:30 INFO - Type: GPU 07:13:30 INFO - Bus: Built-In 07:13:30 INFO - VRAM (Total): 512 MB 07:13:30 INFO - VRAM (Dynamic, Max): 10 07:13:30 INFO - Vendor: Intel (0x8086) 07:13:30 INFO - Device ID: 0x0116 07:13:30 INFO - Revision ID: 0x0009 07:13:30 INFO - Displays: 07:13:30 INFO - Display: 07:13:30 INFO - Resolution: 1600 x 1200 @ 60 Hz 07:13:30 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 07:13:30 INFO - Display Serial Number: 1600x1200 60 07:13:30 INFO - Main Display: Yes 07:13:30 INFO - Mirror: Off 07:13:30 INFO - Online: Yes 07:13:30 INFO - Rotation: Supported 07:13:30 INFO - Return code: 0 07:13:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:13:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:13:30 INFO - Python 2.7.3 07:13:30 INFO - Return code: 0 07:13:30 INFO - grabbing minidump binary from tooltool 07:13:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:13:30 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 0x103ae89f0>, '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 0x103848db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103adc8c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:13:30 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 07:13:30 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 07:13:31 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:13:31 INFO - Return code: 0 07:13:31 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 07:13:31 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:13:31 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:13:31 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 07:13:31 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:13:31 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/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0065', '--webServer', 'localhost'] in /builds/slave/test/build 07:13:31 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/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0065 --webServer localhost 07:13:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HkIrKdm96l/Render', 07:13:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:13:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:13:31 INFO - 'HOME': '/Users/cltbld', 07:13:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:13:31 INFO - 'LOGNAME': 'cltbld', 07:13:31 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:13:31 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 07:13:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:13:31 INFO - 'MOZ_NO_REMOTE': '1', 07:13:31 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:13:31 INFO - 'NO_EM_RESTART': '1', 07:13:31 INFO - 'PAGER': '/bin/cat', 07:13:31 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:13:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:13:31 INFO - 'PWD': '/builds/slave/test', 07:13:31 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:13:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:13:31 INFO - 'SHELL': '/bin/bash', 07:13:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Wnpav1E41p/Listeners', 07:13:31 INFO - 'TMPDIR': '/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/', 07:13:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:13:31 INFO - 'USER': 'cltbld', 07:13:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:13:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:13:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:13:31 INFO - 'XPC_FLAGS': '0x0', 07:13:31 INFO - 'XPC_SERVICE_NAME': '0', 07:13:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 07:13:31 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/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0065', '--webServer', 'localhost'] with output_timeout 3600 07:13:31 INFO - mozversion INFO | application_buildid: 20151116053834 07:13:31 INFO - mozversion INFO | application_changeset: a642464a44992122f55bbe919db79b93bfec485b 07:13:31 INFO - mozversion INFO | application_display_name: Nightly 07:13:31 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:13:31 INFO - mozversion INFO | application_name: Firefox 07:13:31 INFO - mozversion INFO | application_remotingname: firefox 07:13:31 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 07:13:31 INFO - mozversion INFO | application_vendor: Mozilla 07:13:31 INFO - mozversion INFO | application_version: 45.0a1 07:13:31 INFO - mozversion INFO | platform_buildid: 20151116053834 07:13:31 INFO - mozversion INFO | platform_changeset: a642464a44992122f55bbe919db79b93bfec485b 07:13:31 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 07:13:31 INFO - mozversion INFO | platform_version: 45.0a1 07:13:31 INFO - 2015-11-16 07:13:31,473 DEBUG : using testdate: 1447686811 07:13:31 INFO - 2015-11-16 07:13:31,473 DEBUG : actual date: 1447686811 07:13:31 INFO - 2015-11-16 07:13:31,523 INFO : starting webserver on 'localhost:49268' 07:13:31 INFO - 2015-11-16 07:13:31,524 INFO : Starting test suite t-yosemite-r5-0065.e 07:13:31 INFO - 2015-11-16 07:13:31,524 INFO : Starting test dromaeo_css 07:13:31 INFO - 2015-11-16 07:13:31,524 DEBUG : operating with platform_type : mac_ 07:13:31 INFO - 2015-11-16 07:13:31,525 INFO : Initialising browser for dromaeo_css test... 07:13:31 INFO - 2015-11-16 07:13:31,549 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/tmpzJWmj2/profile http://localhost:49268/getInfo.html 07:13:36 INFO - 2015-11-16 07:13:36,178 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:13:36 INFO - 2015-11-16 07:13:36,178 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:13:36 INFO - 2015-11-16 07:13:36,178 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 07:13:36 INFO - 2015-11-16 07:13:36,178 DEBUG : BROWSER_OUTPUT: __metrics 07:13:36 INFO - 2015-11-16 07:13:36,956 INFO : Browser initialized. 07:13:36 INFO - 2015-11-16 07:13:36,956 INFO : Running cycle 1/1 for dromaeo_css test... 07:13:36 INFO - 2015-11-16 07:13:36,956 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/tmpzJWmj2/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:13:49 INFO - 2015-11-16 07:13:49,259 DEBUG : BROWSER_OUTPUT: RSS: Main: 241836032 07:13:49 INFO - 2015-11-16 07:13:49,259 DEBUG : BROWSER_OUTPUT: 07:14:39 INFO - 2015-11-16 07:14:39,104 DEBUG : BROWSER_OUTPUT: 1447686879103 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] 07:16:49 INFO - 2015-11-16 07:16:49,841 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49268/tests/dromaeo/cssquery-ext.html) 07:16:50 INFO - 2015-11-16 07:16:50,935 DEBUG : BROWSER_OUTPUT: RSS: Main: 264065024 07:16:50 INFO - 2015-11-16 07:16:50,935 DEBUG : BROWSER_OUTPUT: 07:19:53 INFO - 2015-11-16 07:19:53,020 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-ext.html (next: http://localhost:49268/tests/dromaeo/cssquery-jquery.html) 07:19:53 INFO - 2015-11-16 07:19:53,610 DEBUG : BROWSER_OUTPUT: RSS: Main: 270872576 07:19:53 INFO - 2015-11-16 07:19:53,610 DEBUG : BROWSER_OUTPUT: 07:22:55 INFO - 2015-11-16 07:22:55,343 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49268/tests/dromaeo/cssquery-mootools.html) 07:22:55 INFO - 2015-11-16 07:22:55,936 DEBUG : BROWSER_OUTPUT: RSS: Main: 275243008 07:22:55 INFO - 2015-11-16 07:22:55,936 DEBUG : BROWSER_OUTPUT: 07:25:57 INFO - 2015-11-16 07:25:57,601 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49268/tests/dromaeo/cssquery-prototype.html) 07:25:58 INFO - 2015-11-16 07:25:58,210 DEBUG : BROWSER_OUTPUT: RSS: Main: 278327296 07:25:58 INFO - 2015-11-16 07:25:58,211 DEBUG : BROWSER_OUTPUT: 07:29:00 INFO - 2015-11-16 07:29:00,819 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49268/tests/dromaeo/cssquery-yui.html) 07:29:01 INFO - 2015-11-16 07:29:01,424 DEBUG : BROWSER_OUTPUT: RSS: Main: 283320320 07:29:01 INFO - 2015-11-16 07:29:01,424 DEBUG : BROWSER_OUTPUT: 07:32:03 INFO - 2015-11-16 07:32:03,939 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-yui.html (next: http://localhost:49268/tests/dromaeo/cssquery-dojo.html) 07:32:04 INFO - 2015-11-16 07:32:04,197 DEBUG : BROWSER_OUTPUT: RSS: Main: 288038912 07:32:04 INFO - 2015-11-16 07:32:04,197 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,197 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:32:04 INFO - 2015-11-16 07:32:04,197 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:32:04 INFO - 2015-11-16 07:32:04,198 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:32:04 INFO - 2015-11-16 07:32:04,198 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:32:04 INFO - 2015-11-16 07:32:04,198 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2523.7476252374763;2584.638150658908;2648.7351264873528;2689.354554906823;2689.8789554470045;4436.645068394525;4438.822447102116;4472.7987240574175;4493.4158559387315;4503.482099558551;4277.721948073381;4387.648988080954;4390.802413891374;4458.464984201901;4512.59386655201;4031.3146765049937;4106.548279689232;4108.26051310764;4124.814383352741;4185.330347144458;512.3420783433351;3990.3615421532418;4110.157417729359;4155.58444155585;4292.055747735509;4043.4945631796027;4079.1637714268504;4101.712880098395;4105;4151.335786274181;4095.4266402703647;4102.179564087165;4124.505059392862;4134.91730165398;4203.369494575808;3951.723379363446;3964.088259700285;4050.3114470539786;4095;4129.525104612978;4234.9364759528635;4390.604845563883;4402.581754733295;4405.757683327416;4504;4674.228752255874;4675.438947326308;4676.251799712064;4698.859034228979;4797.784099715521;4614.653900957442;4652.302154676791;4755.904881902377;4781.3784208053075;4818.012307476959;4438.289873620205;4457.442819647544;4460.330950357407;4469.44131983502;4557.794899229542;4917.139500587383;4926.137925863031;4942.0363029209675;4945.876353091202;4987.202047672355;4467.30756732707;4500;4556.635469162459;4568.246239370533;4676.08816280822;4679.812807487662;4681.836135735233;4751.857444276678;4811.615070794328;4822.903541929212;4518.322251662277;4588.059447813191;4661.067786442725;4680.602148817321;4709.952900470951;4593.127305811885;4637.837675681402;4686.179918514246;4699.78850951708;4749.691270067435;3640.162762564625;3656.5246517952496;3660.6888414484533;3670.522832031819;3685.539307586552;3234.2884565395575;3281.704646581819;3366.074329559342;3374.4938259261307;3386.339663765542;4367.410399596014;4371.650267978554;4452.287633978548;4489.73061616304;4496.505384407713;4787.305840653085;4827.637927155407;4831.275308703653;4852.175130227799;4895.118878601815;4326.848560300437;4372.650187984954;4442.8222871085445;4513.368128462018;4528.88677783058;4192.413062171298;4199.727017743837;4204.327307630764;4213.389058586487;4233.618974292329;4823.083614113378;4901.215805471107;4923.310736496894;4927;4982.8754281143265;4567.200739870443;4619.514950930104;4744.596709279612;4772.570468657837;4790.8323208687525;4943.456219815889;4958.45456999737;4988.052270068675;4999.0501804657;5030.220315851049;4702.0360826031265;4721.5750582447745;4722.858314250578;4745.335653008513;4757.286407038833;4550.704204226715;4571.085782843378;4691.179043667413;4739;4772.164871147605;4631.745254010927;4640.396748422683;4651.604613607881;4678.134545109029;4756.524347565216;4461.866144015685;4642.953570464252;4650.4186976627925;4659.65052621048;4706.835260765857;4486.506484286791;4567.771611419482;4576.153411618728;4631.907361852812;4650.86047418578;4266.402703621434;4687.648426367968;4696.600788932979;4712.50518695532;4747.335373047707;4458.621017213443;4495.100979804118;4624.190766615761;4637.744924029076;4638.698484598491 07:32:04 INFO - 2015-11-16 07:32:04,198 DEBUG : BROWSER_OUTPUT: |1;ext.html;456.4385805459285;470.48951887202384;477.93659108483627;483.9709617422957;492.7462356886202;31798.36403271936;32392.19019524507;32399;32400.351992960157;32809.83595082027;34749.47875781865;34837.651623483755;34889.30221395571;35342;35391.823040884825;7581.279778421042;7639.083310002808;7652.808679782995;7674.424418168632;7773.300402963732;7464.402847772192;7564.054493188351;7677.117131529862;7681.3086822186;7712.652930618107;7500.54996700197;7513.849723005564;7610.581418022007;7636.618169091551;7673.194314596971;7554.320111189992;7629.65666545004;7656.464047516676;7685.730999415049;7729.149793522708;7379.298966598165;7526.09686837583;7537.660805263777;7646.082470103624;7653.579053152074;32499;32977.505337419956;32987.835060824786;33184.3363132736;33461.49807752886;2075.823554997827;2173.7717539658424;2222.344408399526;2421.2857207123766;2537.1373732930706;21900.23349182787;22355.552888942293;22782.772172278397;23275.650865237036;23500.647490287658;1947.4936516505668;1967.980320196794;1971.7831038585743;1992.5118346005322;2001.3395579458743;201885;202190;202760;202954;203876;33264.83367583147;33680.326393471994;33715.15712107217;34153.31693366119;34321.65678343234;33509.66490335114;33538.32923341519;33598.30418653946;33945.830270848484;34110;10807.513661885234;10832.512536935857;10835.404052777016;10860.891391085988;11013.229073964745;8353.289970352587;8462.576871156418;8490.702825401206;8511.446755960842;8643.049264580892;11355.37545435009;11406.714832129097;11421;11423.257488263236;11470;5103.7192954387865;5195.168772996302;5233.921491177635;5244.554212891947;5258.1849813279005;781.6873250699765;806.3992325717378;806.8386322735477;844.8437039147777;863.4344504349662;22369.217077402212;22782;22938.541229175324;23094.42263943415;23303;829.3116713128089;848.410354803418;854.9487030778173;857.8584533552018;864.6800683746928;11511.079113670887;11657.417129143509;11666.125040621988;11794.705132371759;11835.763284734428;324486;331471;334419;334737;336432;43320;43923.78038109853;44232.3365149523;44653.55346446559;44661.55338446639;1119.6081371519904;1123.640435060789;1128.700894263021;1129.824877144044;1152.740633357488;21486.462838429165;22053.22813701513;22297.219597314015;22386;22439.21462748796;36343;36595.26809463849;36858.44712329264;37001.44497832588;37049.25901482009;227075;229610;230734;231781;232522;25541.48917021612;25672.871635641703;35187.82406087953;37471.81264093662;37603.623963760016;35722.285554288246;35833.28333433265;35947.46078808872;36112.81943590265;36133.27733445369;28640.283992900346;30444;30687.2328191797;30794.38411231718;31846.68153318437;29449.85275073611;29661.258468537595;29732.256693582833;29982.400351993274;30215.848920755256;29288;29878;30113;30342.393152137276;30354.84822575873;26029.869850650626;27305.863470682518;28136.43727125487;28645.427091457637;28732.281692957007;19469.318573849847;19885.204591816164;19902.70145947841;19922.103505342006;20074.096665649788 07:32:04 INFO - 2015-11-16 07:32:04,202 DEBUG : BROWSER_OUTPUT: |2;jquery.html;274.96837863645686;275.50546768550464;275.5536031628762;279.5206221330418;286.63740368433935;11705.824412633818;14263.71472570548;14749.115053096823;15011.699766004687;15159.393624255017;9528.523573821316;9684.08001239881;9821.901780982189;13869.306534673276;14189.432422703105;3519.3841077811408;3625.836837342326;3658.3780757271193;3691.2248427830186;3695.519582454277;3549.2723991581793;3581.4627805829205;3582.3551760683067;3595.2270261893686;3655.7806531608057;2713.3623598454346;2722.7005029446746;3542.4509201073874;3607.170350819313;3857.5756666766633;3927.9803600981954;3952.980235098835;3960.3861401482673;3965.960340396588;3988.8603898863544;3299.868005279786;3306.487494438366;3313.4201514735064;3348.497725341194;3353.312570922955;10331;10613.257072004963;10622.468876556219;10623.097036751886;10719.571217151304;642.7043559962423;1556.9766453503207;1559.7816305717208;1585.69871724372;1660.692771837202;7620.123685776096;7649.655765490566;7785.844283114363;7814.960925195338;7912.643931023118;1291.8126871603658;1305.4451857960423;1306.6929271621161;1323.4507679313074;1345.9057865949387;45997.77001115007;47253.5274647256;47441.28838067432;47465.76267118642;47843.76078119587;5194.92207616886;5225.190095535198;5238.73806309683;5293.258943747878;5371.060064488699;6014.88724585953;6019.819405417845;6024;6036.15493830864;6105.32841387447;4231.386448964883;4251.29853574163;4282.892927676833;4288.378185163134;4335.978320108442;4250.638695710837;4250.893727656833;4327.545607711208;4439.600435960779;4447.399601053817;2342.695449591542;2368.810495160383;2380.785729284373;2396.724376696702;2402.9759702402753;844.4511067805976;850.7915560687671;855.5123579559715;865.8138500222483;909;349.1707195410899;362.8421636588093;364.36600315450926;366.8349242840679;370.4295385106905;9019.098090190928;9464;9546.42721436716;9559.426434413957;9631.08504692053;372.9962700373016;374.80322830513654;380.1560535610939;383.6240484325377;395.1760579192416;5009.7244651544515;5128.564072053842;5203;5208.296879921162;5267.157254839208;319192;331381;367031;449877;481119;53961.1905821413;57589.424105759244;58073.41926580764;58838.41161588415;59301.703491482265;400.8136216659209;409.0305974839649;410.01391653075;410.24514892597165;411.3788179848391;8768.561571921506;8864.42381245217;8892.911070889468;8909.55452227399;8996.820063598821;28188.71811281861;28582.857085714437;28617.570736439386;28939.131826045254;29274.853625731736;38577;38979;39430.282609022106;39598.60401395949;39896.60103398929;4862.610991120631;4948.208286674115;4962.751862406937;4994.9750251248515;5000.57495112905;9037.909620903707;9178.862317065383;9204.539773011189;9344.579493922654;9523.714288571355;7945.364370850433;8162.632681529227;8206.343492520704;8266.669333226844;8294.253517183482;6895.138107736533;7391.40868730511;7426.183119856703;7992.960035199787;8098.433109682265;8114.634841432267;8253.83492330162;8331.083580805986;8353.624086916225;8434.915650843413;5016.72408017548;5019.974900125476;5036.269740887624;5058;5125.564327032244;7988.121306656147;8254.917450825655;8337.374696897636;8393.454425462325;8423.4945903246 07:32:04 INFO - 2015-11-16 07:32:04,205 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1436.6552027513396;1463.7996842589082;1475.4172102019702;1494.5740463967766;1510.2750679673752;5672.092465205568;6045.486133678632;6221.284552276484;6633.568818026825;6654.500912431568;6204.96897515513;6364.045393191023;6466.030095485679;6504.154459920203;6513.837154071139;1827.7441158237857;1856.2111102781332;1856.9071546422624;1856.9972215003882;1860.8604354673453;1838.9080545972715;1854.5549068223663;1866.0762922353454;1885.9434216973514;1890.3289332287047;1832.853371730265;1856.9071546422692;1859.953501162475;1862.5995410986636;1866.7479890214852;1779.8932064076132;1818.0818686563334;1822.7812662480587;1824.771903512061;1825.698759704647;1828.3509354179341;1842.178715259786;1852.2498388152685;1879.2576932111876;1881.8400435962822;6411.3588641135975;6507.251666058369;6508.511861610398;6514.57655252407;6515.250746164157;4034.495688038995;4099;4120.979395103005;4121.093359460914;4139.151473947833;2305.319930620454;2330.52224294021;2374.228375777879;2374.8575085494926;2383.5709572276983;737.9520331178456;739.9038125043763;748.8577170337618;762.230147550972;779.516699646223;8546.52994085325;8556.657733690645;8562.700305489278;8568.485890846507;8582.313414926792;3558.768680035789;3620.728445366608;3682.0978860179425;3709.4621279914263;3720.479132921393;7377.741779037815;7384.372328352043;7404.111506619241;7405.074365704287;7474.065741782278;4065.3698676705158;4076.3681629346906;4085.264652362603;4095.4266402703647;4140.710150289451;3320.236345640468;3416.197193659488;3701.833417496165;3707.1658876753054;3737.289914916157;3040.3767227718263;3139.9058028259187;3140.4661207594763;3146.465100932847;3154;966.3573723473952;1023.4933707814531;1027.6762819711766;1039.6828967165088;1039.9688009359731;852.6376290076693;871.9171678690515;882.0429833630583;882.668999125328;1131.7736452709491;5989.341172471025;6056.273247210363;6065.150878876961;6152.3540028297275;6182.350853160354;936.166811537732;954.3271993244746;960.8991055939166;974.0746291023556;978.574320170728;4464.665150113755;4528.207563676344;4583.495815460296;4634.791434385461;4681.7190968542;7402.592857392895;7550.471466997367;7601.505902116345;7666.386689064973;7764.6894124234395;7377.557346559223;7464.70141194357;7488.063992001;7596.240375962359;7606.163322034572;5927.2590926134235;6054.152418661391;6074.362191969868;6125.111858780452;6140.078988151724;5745.7988970387505;5750.022496175577;5762.337331206965;5802.448767367094;5835.307760749335;6486.54594178403;6698.430633396216;6743;6785.762498312535;6812.14848143982;6780.69486873082;6929.757458488929;6937.930620693728;6985.476089293425;7019.508634395544;4850.6119510438375;5197.168453047494;5651.915221271602;5689.288838895138;5761.164631128547;5626.212330273683;5981.850453738517;5991.730372133177;6027.60820546663;6085;5649.096144616841;5672.347680016851;5695.658260504383;5772.1630363596205;5810.7094645266725;5595.969232603848;5692.31692196939;5699.458551437772;5712.6286791358425;5715.085586306171;5719.5138413235345;5759.366469688414;5786.884262314646;5792.21805056312;5794.072948328416;5145.536901678867;5244.9737751310995;5254.763535640982;5274.76263568148;5276.050310944067;5283.181106928432;5295.099833028471;5302.920456193083;5330.227117067926;5330.573554115584 07:32:04 INFO - 2015-11-16 07:32:04,210 DEBUG : BROWSER_OUTPUT: |4;prototype.html;252.49878990204454;255.96800399950004;259.02477173441986;264.4750170910743;267.3130055756704;5084.593232541397;5086.643934924557;5225.163973764198;5254.290670759447;5254.894902101961;4995.625328100398;5135.486451354872;5196.948030519694;5213.635045546814;5261.552768014723;3952.584978577251;3959.2081583683234;3959.386295124253;3960.841566337343;4007.2386246613196;3955.564887862333;3962.029302820813;3966.9206615867665;4022.7184097113213;4047.2310261050307;3808.7143464240294;3920.137569734668;3932.665723413513;3935.5080614923136;3975.4434379186937;3876.9806150969207;3879.437481565157;3900;3949.3878448840474;3956.4460975463458;3369.107186595554;3371.2751758371824;3372.207531230159;3392.457206846893;3407.829608519589;4830.2030165022725;4851.369321988119;4987.625928055374;4989.226669866177;5066.316047333599;4421.602055814992;4434.33484977256;4437.356583295436;4438.911221775578;4443.200223959686;5418.783248670048;5443.727813609304;5463.508284254436;5514.007478653841;5518.33779946405;3655.342038433081;3656.9085772855624;3680.4663323818163;3725.9441108383394;3729.981350093259;5613.90528846875;5748.281464816898;5766.971165144148;5830.825075247707;5831.212786273841;3638.1086633774894;3654.470101835219;3667.1932174921476;3700.5744339400776;3729.5151630288433;3736.663700266989;3746.213295208037;3760.7179461539945;3769.246150769857;3791.1090893640526;4370.453693288339;4380.145871555016;4424.491183513937;4442.644588432918;4451.910961780746;5416.0792665247;5422.349318081855;5486.6982315973;5548;5561.274975262092;1303.7066660001612;1308.784050631654;1310.0763961407185;1327.0445279398818;1327.3097989045643;835.9247667709935;837.1670188162817;840.1346612988632;844.9704260350858;861.573521107056;5289.47105289468;5335.599830012765;5336.946630533645;5352.223927530486;5357.919631205535;5715.199872017921;5727.799527016535;5793.420657934173;5797.826065218051;5799.5070419014855;5311.123664595376;5318.9202161967605;5327.920081198785;5334.1732031535175;5367.087595108841;3029.1366960416176;3091.30445649727;3097.659257481675;3097.9776673697625;3123.4846250368887;5896.174535565025;5918.526517878559;5968.432998865101;5970.582059255898;6000.219971403777;5650.915236271459;5737.88524229513;5825.621334613322;5923.526117910556;5936.406359364116;5916.787058652966;5970.791022314198;6068.150458935753;6073.635581864925;6081.483073938764;5767.077267637158;5768.653880767168;5776.971115144397;5836.328822185503;5842.38654941225;5552.805651802168;5601.551875849841;5633.324001119892;5697.4302569742695;5710.029295019774;5954.166416701579;5957.434043765836;6017.729202185825;6023.48800351975;6029.095635654511;3663.5420572428447;3684.1894783147663;3685.4840322355426;3737.7009839212255;3738.943915841319;5713.400092990176;5717.113847353667;5780.94219057804;5797.4782269595935;5801.303843538633;5440.755166017618;5547.084731019337;5579.637323573955;5606.0469720148485;5635.239242702347;5539.8892022158525;5544.1960915667805;5549.72251387421;5636;5681.488666020078;5420.457954204706;5463.590230732791;5503.972480137734;5509.614326997232;5511;5300.072487314627;5546.7781288748;5552.194931734956;5580.35825880029;5631.070873306023;5441.401445840876;5455.8363249102595;5493.7802487900035;5516.862078447911;5520.254765606592 07:32:04 INFO - 2015-11-16 07:32:04,211 DEBUG : BROWSER_OUTPUT: |5;yui.html;607.7903123422418;613.4172536090712;618.6411881108958;625.6996641612023;632.3202557250955;10519.684409467718;11040.723981900437;11145.888541114597;11168.553257869697;11244.606438774645;10469.31949423287;10647.414392208426;10732.678019659403;10779.676609701703;10786.298890572127;561.3488353509929;579.3048341989629;703.3810246982661;720.1682057223915;721.606724335236;702.5433468245656;715.3561794385043;723.6598798564693;724.3480867219519;724.5037149552547;734.7024455095694;763.7441457111875;764.2930289482234;764.9694012239504;765.5024234247755;747.6934456872656;758.6813538313921;759.0701390796286;760.106874422554;765.1545042727789;561.612487383704;567.1492760858712;571.9428057194248;572.0532518681589;572.1303618499899;10878.72803179919;11182.273152245078;11201;11219.60731374398;11244.325340479598;9174.128457796498;9271.211946984515;9570.808583828353;9900.80198396028;9906.702798915972;7583.317501424843;7761.8447631047065;7824.906651021478;8019.839603207962;8187.38594605407;2679.8660066996767;2771.2240572639694;2781.7496425321615;2791.623130877326;2799.4261176458776;38533;38586;38643;39264.803675981726;40646.59353406487;7317.487775855639;7340.853182936311;7367.594782286918;7377.823542055106;7429.8688495204915;9613.230941524662;9686.418814870989;15551.766723499157;15738.842611573968;15855.365785368456;5141.76862041209;5185.559227465707;5320.441353657888;5342.91985620216;5349.893002139936;3004.8948286809855;3050.527168288919;3051.1761824307314;3086.27472543952;3125.1874512626882;2156.9784302156777;2182.7489838668757;2209.712737344135;2216.789405006522;2227.7438094619;327.54307740701586;332.0817938400325;336.5607881714386;337.6522182152387;341.7112539903777;400.6494317472212;419.0153140120692;460.53485979161286;475.8596214116844;525.3433208489388;6233.470155036782;6691.26396096429;6762.289959554176;6787.694553745093;6794.72821087151;377.6289449620652;429.1802656925258;489.6523468337449;492.25423483422645;495.1953076251092;3120.1731541141617;3155.984220078931;3176.2059485128716;3184.092533627905;3189.8086114833186;49602.75198623984;49727.75136124369;49914.50085499171;50109.24836127388;50139.74930125326;38157;38416.23167536633;38624.42063369052;38683.41974870379;38785.80607097003;37850.43224351637;37892.810535947145;38593.807030964665;39137.41293880594;39624.60375396209;6768.729250830109;6812.250652428328;6854.143232095988;6868.484863635147;6986.371226589428;27576.724232758217;27941.860290698416;28910.566341505313;29500.557491638072;29720;37624.43563346497;37697.62302376941;38221;38665.6133438662;39117.60882391254;5928.229330187048;6109.877802444015;6260.87304285233;6332.493400528039;6337.96831015842;9003.414778039407;9086.45481271126;9209.355345125778;9288.860667090134;9694.660686875926;8444.831103378021;8563.95718021406;8880.067592902653;8910.242629376575;9165.312601555044;8674.522901240493;8741.300695944436;8829.779255518664;8952.14954579314;8983.91016089857;8423.241908228289;8425.368097392597;8437.240648341678;8655.610497527501;8860.468371897707;7460;7574.3183113520045;7678.117016542946;7697.307242348215;7874.960625196837;7461.888071678821;7536.0956685198125;7578.507397019176;7899.249571290718;7945.284924356835 07:32:04 INFO - 2015-11-16 07:32:04,211 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:32:04 INFO - 2015-11-16 07:32:04,211 DEBUG : BROWSER_OUTPUT: __start_cc_report 07:32:04 INFO - 2015-11-16 07:32:04,212 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,306 07:32:04 INFO - 2015-11-16 07:32:04,212 DEBUG : BROWSER_OUTPUT: __end_cc_report 07:32:04 INFO - 2015-11-16 07:32:04,212 DEBUG : BROWSER_OUTPUT: __startTimestamp1447687924191__endTimestamp 07:32:04 INFO - 2015-11-16 07:32:04,212 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,212 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:32:04 INFO - 2015-11-16 07:32:04,213 DEBUG : BROWSER_OUTPUT: Number of tests: 6 07:32:04 INFO - 2015-11-16 07:32:04,213 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,213 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4397.22 Median:4556.64 stddev:567.34 (12.5%) stddev-sans-first:549.72 07:32:04 INFO - 2015-11-16 07:32:04,214 DEBUG : BROWSER_OUTPUT: Values: 2523.7 2584.6 2648.7 2689.4 2689.9 4436.6 4438.8 4472.8 4493.4 4503.5 4277.7 4387.6 4390.8 4458.5 4512.6 4031.3 4106.5 4108.3 4124.8 4185.3 512.3 3990.4 4110.2 4155.6 4292.1 4043.5 4079.2 4101.7 4105.0 4151.3 4095.4 4102.2 4124.5 4134.9 4203.4 3951.7 3964.1 4050.3 4095.0 4129.5 4234.9 4390.6 4402.6 4405.8 4504.0 4674.2 4675.4 4676.3 4698.9 4797.8 4614.7 4652.3 4755.9 4781.4 4818.0 4438.3 4457.4 4460.3 4469.4 4557.8 4917.1 4926.1 4942.0 4945.9 4987.2 4467.3 4500.0 4556.6 4568.2 4676.1 4679.8 4681.8 4751.9 4811.6 4822.9 4518.3 4588.1 4661.1 4680.6 4710.0 4593.1 4637.8 4686.2 4699.8 4749.7 3640.2 3656.5 3660.7 3670.5 3685.5 3234.3 3281.7 3366.1 3374.5 3386.3 4367.4 4371.7 4452.3 4489.7 4496.5 4787.3 4827.6 4831.3 4852.2 4895.1 4326.8 4372.7 4442.8 4513.4 4528.9 4192.4 4199.7 4204.3 4213.4 4233.6 4823.1 4901.2 4923.3 4927.0 4982.9 4567.2 4619.5 4744.6 4772.6 4790.8 4943.5 4958.5 4988.1 4999.1 5030.2 4702.0 4721.6 4722.9 4745.3 4757.3 4550.7 4571.1 4691.2 4739.0 4772.2 4631.7 4640.4 4651.6 4678.1 4756.5 4461.9 4643.0 4650.4 4659.7 4706.8 4486.5 4567.8 4576.2 4631.9 4650.9 4266.4 4687.6 4696.6 4712.5 4747.3 4458.6 4495.1 4624.2 4637.7 4638.7 07:32:04 INFO - 2015-11-16 07:32:04,215 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,216 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:38376.11 Median:182229.42 stddev:68730.22 (37.7%) stddev-sans-first:68864.06 07:32:04 INFO - 2015-11-16 07:32:04,217 DEBUG : BROWSER_OUTPUT: Values: 456.4 470.5 477.9 484.0 492.7 31798.4 32392.2 32399.0 32400.4 32809.8 34749.5 34837.7 34889.3 35342.0 35391.8 7581.3 7639.1 7652.8 7674.4 7773.3 7464.4 7564.1 7677.1 7681.3 7712.7 7500.5 7513.8 7610.6 7636.6 7673.2 7554.3 7629.7 7656.5 7685.7 7729.1 7379.3 7526.1 7537.7 7646.1 7653.6 32499.0 32977.5 32987.8 33184.3 33461.5 2075.8 2173.8 2222.3 2421.3 2537.1 21900.2 22355.6 22782.8 23275.7 23500.6 1947.5 1968.0 1971.8 1992.5 2001.3 201885.0 202190.0 202760.0 202954.0 203876.0 33264.8 33680.3 33715.2 34153.3 34321.7 33509.7 33538.3 33598.3 33945.8 34110.0 10807.5 10832.5 10835.4 10860.9 11013.2 8353.3 8462.6 8490.7 8511.4 8643.0 11355.4 11406.7 11421.0 11423.3 11470.0 5103.7 5195.2 5233.9 5244.6 5258.2 781.7 806.4 806.8 844.8 863.4 22369.2 22782.0 22938.5 23094.4 23303.0 829.3 848.4 854.9 857.9 864.7 11511.1 11657.4 11666.1 11794.7 11835.8 324486.0 331471.0 334419.0 334737.0 336432.0 43320.0 43923.8 44232.3 44653.6 44661.6 1119.6 1123.6 1128.7 1129.8 1152.7 21486.5 22053.2 22297.2 22386.0 22439.2 36343.0 36595.3 36858.4 37001.4 37049.3 227075.0 229610.0 230734.0 231781.0 232522.0 25541.5 25672.9 35187.8 37471.8 37603.6 35722.3 35833.3 35947.5 36112.8 36133.3 28640.3 30444.0 30687.2 30794.4 31846.7 29449.9 29661.3 29732.3 29982.4 30215.8 29288.0 29878.0 30113.0 30342.4 30354.8 26029.9 27305.9 28136.4 28645.4 28732.3 19469.3 19885.2 19902.7 19922.1 20074.1 07:32:04 INFO - 2015-11-16 07:32:04,217 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,217 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:20183.73 Median:4331.76 stddev:64854.94 (1497.2%) stddev-sans-first:65019.65 07:32:04 INFO - 2015-11-16 07:32:04,219 DEBUG : BROWSER_OUTPUT: Values: 275.0 275.5 275.6 279.5 286.6 11705.8 14263.7 14749.1 15011.7 15159.4 9528.5 9684.1 9821.9 13869.3 14189.4 3519.4 3625.8 3658.4 3691.2 3695.5 3549.3 3581.5 3582.4 3595.2 3655.8 2713.4 2722.7 3542.5 3607.2 3857.6 3928.0 3953.0 3960.4 3966.0 3988.9 3299.9 3306.5 3313.4 3348.5 3353.3 10331.0 10613.3 10622.5 10623.1 10719.6 642.7 1557.0 1559.8 1585.7 1660.7 7620.1 7649.7 7785.8 7815.0 7912.6 1291.8 1305.4 1306.7 1323.5 1345.9 45997.8 47253.5 47441.3 47465.8 47843.8 5194.9 5225.2 5238.7 5293.3 5371.1 6014.9 6019.8 6024.0 6036.2 6105.3 4231.4 4251.3 4282.9 4288.4 4336.0 4250.6 4250.9 4327.5 4439.6 4447.4 2342.7 2368.8 2380.8 2396.7 2403.0 844.5 850.8 855.5 865.8 909.0 349.2 362.8 364.4 366.8 370.4 9019.1 9464.0 9546.4 9559.4 9631.1 373.0 374.8 380.2 383.6 395.2 5009.7 5128.6 5203.0 5208.3 5267.2 319192.0 331381.0 367031.0 449877.0 481119.0 53961.2 57589.4 58073.4 58838.4 59301.7 400.8 409.0 410.0 410.2 411.4 8768.6 8864.4 8892.9 8909.6 8996.8 28188.7 28582.9 28617.6 28939.1 29274.9 38577.0 38979.0 39430.3 39598.6 39896.6 4862.6 4948.2 4962.8 4995.0 5000.6 9037.9 9178.9 9204.5 9344.6 9523.7 7945.4 8162.6 8206.3 8266.7 8294.3 6895.1 7391.4 7426.2 7993.0 8098.4 8114.6 8253.8 8331.1 8353.6 8434.9 5016.7 5020.0 5036.3 5058.0 5125.6 7988.1 8254.9 8337.4 8393.5 8423.5 07:32:04 INFO - 2015-11-16 07:32:04,219 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,219 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4465.34 Median:5697.56 stddev:2272.05 (39.9%) stddev-sans-first:2267.03 07:32:04 INFO - 2015-11-16 07:32:04,221 DEBUG : BROWSER_OUTPUT: Values: 1436.7 1463.8 1475.4 1494.6 1510.3 5672.1 6045.5 6221.3 6633.6 6654.5 6205.0 6364.0 6466.0 6504.2 6513.8 1827.7 1856.2 1856.9 1857.0 1860.9 1838.9 1854.6 1866.1 1885.9 1890.3 1832.9 1856.9 1860.0 1862.6 1866.7 1779.9 1818.1 1822.8 1824.8 1825.7 1828.4 1842.2 1852.2 1879.3 1881.8 6411.4 6507.3 6508.5 6514.6 6515.3 4034.5 4099.0 4121.0 4121.1 4139.2 2305.3 2330.5 2374.2 2374.9 2383.6 738.0 739.9 748.9 762.2 779.5 8546.5 8556.7 8562.7 8568.5 8582.3 3558.8 3620.7 3682.1 3709.5 3720.5 7377.7 7384.4 7404.1 7405.1 7474.1 4065.4 4076.4 4085.3 4095.4 4140.7 3320.2 3416.2 3701.8 3707.2 3737.3 3040.4 3139.9 3140.5 3146.5 3154.0 966.4 1023.5 1027.7 1039.7 1040.0 852.6 871.9 882.0 882.7 1131.8 5989.3 6056.3 6065.2 6152.4 6182.4 936.2 954.3 960.9 974.1 978.6 4464.7 4528.2 4583.5 4634.8 4681.7 7402.6 7550.5 7601.5 7666.4 7764.7 7377.6 7464.7 7488.1 7596.2 7606.2 5927.3 6054.2 6074.4 6125.1 6140.1 5745.8 5750.0 5762.3 5802.4 5835.3 6486.5 6698.4 6743.0 6785.8 6812.1 6780.7 6929.8 6937.9 6985.5 7019.5 4850.6 5197.2 5651.9 5689.3 5761.2 5626.2 5981.9 5991.7 6027.6 6085.0 5649.1 5672.3 5695.7 5772.2 5810.7 5596.0 5692.3 5699.5 5712.6 5715.1 5719.5 5759.4 5786.9 5792.2 5794.1 5145.5 5245.0 5254.8 5274.8 5276.1 5283.2 5295.1 5302.9 5330.2 5330.6 07:32:04 INFO - 2015-11-16 07:32:04,221 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,221 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4594.90 Median:5334.89 stddev:1438.83 (27.0%) stddev-sans-first:1405.46 07:32:04 INFO - 2015-11-16 07:32:04,223 DEBUG : BROWSER_OUTPUT: Values: 252.5 256.0 259.0 264.5 267.3 5084.6 5086.6 5225.2 5254.3 5254.9 4995.6 5135.5 5196.9 5213.6 5261.6 3952.6 3959.2 3959.4 3960.8 4007.2 3955.6 3962.0 3966.9 4022.7 4047.2 3808.7 3920.1 3932.7 3935.5 3975.4 3877.0 3879.4 3900.0 3949.4 3956.4 3369.1 3371.3 3372.2 3392.5 3407.8 4830.2 4851.4 4987.6 4989.2 5066.3 4421.6 4434.3 4437.4 4438.9 4443.2 5418.8 5443.7 5463.5 5514.0 5518.3 3655.3 3656.9 3680.5 3725.9 3730.0 5613.9 5748.3 5767.0 5830.8 5831.2 3638.1 3654.5 3667.2 3700.6 3729.5 3736.7 3746.2 3760.7 3769.2 3791.1 4370.5 4380.1 4424.5 4442.6 4451.9 5416.1 5422.3 5486.7 5548.0 5561.3 1303.7 1308.8 1310.1 1327.0 1327.3 835.9 837.2 840.1 845.0 861.6 5289.5 5335.6 5336.9 5352.2 5357.9 5715.2 5727.8 5793.4 5797.8 5799.5 5311.1 5318.9 5327.9 5334.2 5367.1 3029.1 3091.3 3097.7 3098.0 3123.5 5896.2 5918.5 5968.4 5970.6 6000.2 5650.9 5737.9 5825.6 5923.5 5936.4 5916.8 5970.8 6068.2 6073.6 6081.5 5767.1 5768.7 5777.0 5836.3 5842.4 5552.8 5601.6 5633.3 5697.4 5710.0 5954.2 5957.4 6017.7 6023.5 6029.1 3663.5 3684.2 3685.5 3737.7 3738.9 5713.4 5717.1 5780.9 5797.5 5801.3 5440.8 5547.1 5579.6 5606.0 5635.2 5539.9 5544.2 5549.7 5636.0 5681.5 5420.5 5463.6 5504.0 5509.6 5511.0 5300.1 5546.8 5552.2 5580.4 5631.1 5441.4 5455.8 5493.8 5516.9 5520.3 07:32:04 INFO - 2015-11-16 07:32:04,223 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,223 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11011.46 Median:569.55 stddev:13268.67 (2329.7%) stddev-sans-first:13282.89 07:32:04 INFO - 2015-11-16 07:32:04,224 DEBUG : BROWSER_OUTPUT: Values: 607.8 613.4 618.6 625.7 632.3 10519.7 11040.7 11145.9 11168.6 11244.6 10469.3 10647.4 10732.7 10779.7 10786.3 561.3 579.3 703.4 720.2 721.6 702.5 715.4 723.7 724.3 724.5 734.7 763.7 764.3 765.0 765.5 747.7 758.7 759.1 760.1 765.2 561.6 567.1 571.9 572.1 572.1 10878.7 11182.3 11201.0 11219.6 11244.3 9174.1 9271.2 9570.8 9900.8 9906.7 7583.3 7761.8 7824.9 8019.8 8187.4 2679.9 2771.2 2781.7 2791.6 2799.4 38533.0 38586.0 38643.0 39264.8 40646.6 7317.5 7340.9 7367.6 7377.8 7429.9 9613.2 9686.4 15551.8 15738.8 15855.4 5141.8 5185.6 5320.4 5342.9 5349.9 3004.9 3050.5 3051.2 3086.3 3125.2 2157.0 2182.7 2209.7 2216.8 2227.7 327.5 332.1 336.6 337.7 341.7 400.6 419.0 460.5 475.9 525.3 6233.5 6691.3 6762.3 6787.7 6794.7 377.6 429.2 489.7 492.3 495.2 3120.2 3156.0 3176.2 3184.1 3189.8 49602.8 49727.8 49914.5 50109.2 50139.7 38157.0 38416.2 38624.4 38683.4 38785.8 37850.4 37892.8 38593.8 39137.4 39624.6 6768.7 6812.3 6854.1 6868.5 6986.4 27576.7 27941.9 28910.6 29500.6 29720.0 37624.4 37697.6 38221.0 38665.6 39117.6 5928.2 6109.9 6260.9 6332.5 6338.0 9003.4 9086.5 9209.4 9288.9 9694.7 8444.8 8564.0 8880.1 8910.2 9165.3 8674.5 8741.3 8829.8 8952.1 8983.9 8423.2 8425.4 8437.2 8655.6 8860.5 7460.0 7574.3 7678.1 7697.3 7875.0 7461.9 7536.1 7578.5 7899.2 7945.3 07:32:04 INFO - 2015-11-16 07:32:04,224 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:32:04 INFO - 2015-11-16 07:32:04,225 DEBUG : BROWSER_OUTPUT: 07:32:04 INFO - 2015-11-16 07:32:04,893 INFO : Browser exited with error code: 0 07:32:04 INFO - 2015-11-16 07:32:04,928 INFO : Completed test dromaeo_css (00:18:33) 07:32:04 INFO - 2015-11-16 07:32:04,928 INFO : Starting test kraken 07:32:04 INFO - 2015-11-16 07:32:04,928 DEBUG : operating with platform_type : mac_ 07:32:04 INFO - 2015-11-16 07:32:04,928 INFO : Initialising browser for kraken test... 07:32:04 INFO - 2015-11-16 07:32:04,944 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/tmptrgjbE/profile http://localhost:49268/getInfo.html 07:32:08 INFO - 2015-11-16 07:32:08,275 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:32:08 INFO - 2015-11-16 07:32:08,275 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:32:08 INFO - 2015-11-16 07:32:08,275 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 07:32:08 INFO - 2015-11-16 07:32:08,275 DEBUG : BROWSER_OUTPUT: __metrics 07:32:08 INFO - 2015-11-16 07:32:08,994 INFO : Browser initialized. 07:32:08 INFO - 2015-11-16 07:32:08,995 INFO : Running cycle 1/1 for kraken test... 07:32:08 INFO - 2015-11-16 07:32:08,995 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/tmptrgjbE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:32:21 INFO - 2015-11-16 07:32:21,280 DEBUG : BROWSER_OUTPUT: RSS: Main: 241197056 07:32:21 INFO - 2015-11-16 07:32:21,281 DEBUG : BROWSER_OUTPUT: 07:32:24 INFO - 2015-11-16 07:32:24,358 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-beat-detection) 07:32:24 INFO - 2015-11-16 07:32:24,979 DEBUG : BROWSER_OUTPUT: RSS: Main: 259608576 07:32:24 INFO - 2015-11-16 07:32:24,979 DEBUG : BROWSER_OUTPUT: 07:32:28 INFO - 2015-11-16 07:32:28,140 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-dft) 07:32:28 INFO - 2015-11-16 07:32:28,748 DEBUG : BROWSER_OUTPUT: RSS: Main: 267411456 07:32:28 INFO - 2015-11-16 07:32:28,749 DEBUG : BROWSER_OUTPUT: 07:32:32 INFO - 2015-11-16 07:32:32,228 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-fft) 07:32:32 INFO - 2015-11-16 07:32:32,817 DEBUG : BROWSER_OUTPUT: RSS: Main: 267120640 07:32:32 INFO - 2015-11-16 07:32:32,817 DEBUG : BROWSER_OUTPUT: 07:32:35 INFO - 2015-11-16 07:32:35,103 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-oscillator) 07:32:35 INFO - 2015-11-16 07:32:35,693 DEBUG : BROWSER_OUTPUT: RSS: Main: 267845632 07:32:35 INFO - 2015-11-16 07:32:35,693 DEBUG : BROWSER_OUTPUT: 07:32:38 INFO - 2015-11-16 07:32:38,167 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:32:38 INFO - 2015-11-16 07:32:38,756 DEBUG : BROWSER_OUTPUT: RSS: Main: 267984896 07:32:38 INFO - 2015-11-16 07:32:38,756 DEBUG : BROWSER_OUTPUT: 07:32:42 INFO - 2015-11-16 07:32:42,396 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-darkroom) 07:32:42 INFO - 2015-11-16 07:32:42,979 DEBUG : BROWSER_OUTPUT: RSS: Main: 267874304 07:32:42 INFO - 2015-11-16 07:32:42,979 DEBUG : BROWSER_OUTPUT: 07:32:46 INFO - 2015-11-16 07:32:46,728 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-desaturate) 07:32:47 INFO - 2015-11-16 07:32:47,330 DEBUG : BROWSER_OUTPUT: RSS: Main: 268517376 07:32:47 INFO - 2015-11-16 07:32:47,330 DEBUG : BROWSER_OUTPUT: 07:32:50 INFO - 2015-11-16 07:32:50,720 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49268/tests/kraken/driver.html?testName=json-parse-financial) 07:32:51 INFO - 2015-11-16 07:32:51,315 DEBUG : BROWSER_OUTPUT: RSS: Main: 268558336 07:32:51 INFO - 2015-11-16 07:32:51,315 DEBUG : BROWSER_OUTPUT: 07:32:53 INFO - 2015-11-16 07:32:53,112 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49268/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:32:53 INFO - 2015-11-16 07:32:53,692 DEBUG : BROWSER_OUTPUT: RSS: Main: 267202560 07:32:53 INFO - 2015-11-16 07:32:53,692 DEBUG : BROWSER_OUTPUT: 07:32:55 INFO - 2015-11-16 07:32:55,798 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:32:56 INFO - 2015-11-16 07:32:56,437 DEBUG : BROWSER_OUTPUT: RSS: Main: 268169216 07:32:56 INFO - 2015-11-16 07:32:56,439 DEBUG : BROWSER_OUTPUT: 07:32:58 INFO - 2015-11-16 07:32:58,862 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:32:59 INFO - 2015-11-16 07:32:59,458 DEBUG : BROWSER_OUTPUT: RSS: Main: 267984896 07:32:59 INFO - 2015-11-16 07:32:59,458 DEBUG : BROWSER_OUTPUT: 07:33:02 INFO - 2015-11-16 07:33:02,517 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:33:03 INFO - 2015-11-16 07:33:03,128 DEBUG : BROWSER_OUTPUT: RSS: Main: 267579392 07:33:03 INFO - 2015-11-16 07:33:03,128 DEBUG : BROWSER_OUTPUT: 07:33:06 INFO - 2015-11-16 07:33:06,256 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:33:06 INFO - 2015-11-16 07:33:06,848 DEBUG : BROWSER_OUTPUT: RSS: Main: 268812288 07:33:06 INFO - 2015-11-16 07:33:06,849 DEBUG : BROWSER_OUTPUT: 07:33:08 INFO - 2015-11-16 07:33:08,793 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49268/tests/kraken/driver.html?testName=ai-astar) 07:33:09 INFO - 2015-11-16 07:33:09,053 DEBUG : BROWSER_OUTPUT: RSS: Main: 268931072 07:33:09 INFO - 2015-11-16 07:33:09,053 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,053 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:33:09 INFO - 2015-11-16 07:33:09,054 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:33:09 INFO - 2015-11-16 07:33:09,054 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:33:09 INFO - 2015-11-16 07:33:09,054 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:33:09 INFO - 2015-11-16 07:33:09,054 DEBUG : BROWSER_OUTPUT: |0;ai-astar;134;133;140;139;139;151;140;140;138;132 07:33:09 INFO - 2015-11-16 07:33:09,054 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;188;170;194;212;172;191;188;164;205;167 07:33:09 INFO - 2015-11-16 07:33:09,055 DEBUG : BROWSER_OUTPUT: |2;audio-dft;215;212;215;214;210;212;211;211;209;209 07:33:09 INFO - 2015-11-16 07:33:09,055 DEBUG : BROWSER_OUTPUT: |3;audio-fft;83;95;105;147;86;87;93;88;123;85 07:33:09 INFO - 2015-11-16 07:33:09,055 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;107;113;155;113;114;114;153;113;115;161 07:33:09 INFO - 2015-11-16 07:33:09,055 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;157;149;149;157;157;157;157;157;157;143 07:33:09 INFO - 2015-11-16 07:33:09,055 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;164;164;165;164;165;163;165;165;164;165 07:33:09 INFO - 2015-11-16 07:33:09,056 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;123;139;128;141;131;130;127;134;134;123 07:33:09 INFO - 2015-11-16 07:33:09,056 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;73;78;79;80;81;80;81;87;80;81 07:33:09 INFO - 2015-11-16 07:33:09,056 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;81;85;91;90;91;92;92;94;91;95 07:33:09 INFO - 2015-11-16 07:33:09,056 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;108;113;112;111;112;112;112;113;113;113 07:33:09 INFO - 2015-11-16 07:33:09,056 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;171;163;164;168;157;185;172;177;164;162 07:33:09 INFO - 2015-11-16 07:33:09,057 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;189;202;203;200;200;199;202;198;194;186 07:33:09 INFO - 2015-11-16 07:33:09,057 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;84;88;92;91;91;91;91;91;93;94 07:33:09 INFO - 2015-11-16 07:33:09,057 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:33:09 INFO - 2015-11-16 07:33:09,057 DEBUG : BROWSER_OUTPUT: __start_cc_report 07:33:09 INFO - 2015-11-16 07:33:09,057 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,784 07:33:09 INFO - 2015-11-16 07:33:09,058 DEBUG : BROWSER_OUTPUT: __end_cc_report 07:33:09 INFO - 2015-11-16 07:33:09,058 DEBUG : BROWSER_OUTPUT: __startTimestamp1447687989048__endTimestamp 07:33:09 INFO - 2015-11-16 07:33:09,058 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,058 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:33:09 INFO - 2015-11-16 07:33:09,058 DEBUG : BROWSER_OUTPUT: Number of tests: 14 07:33:09 INFO - 2015-11-16 07:33:09,059 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,059 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:138.60 Median:139.50 stddev:5.34 (3.8%) stddev-sans-first:5.40 07:33:09 INFO - 2015-11-16 07:33:09,059 DEBUG : BROWSER_OUTPUT: Values: 134.0 133.0 140.0 139.0 139.0 151.0 140.0 140.0 138.0 132.0 07:33:09 INFO - 2015-11-16 07:33:09,059 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,059 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:185.10 Median:189.50 stddev:16.41 (8.7%) stddev-sans-first:17.37 07:33:09 INFO - 2015-11-16 07:33:09,059 DEBUG : BROWSER_OUTPUT: Values: 188.0 170.0 194.0 212.0 172.0 191.0 188.0 164.0 205.0 167.0 07:33:09 INFO - 2015-11-16 07:33:09,060 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,060 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:211.80 Median:212.00 stddev:2.25 (1.1%) stddev-sans-first:2.07 07:33:09 INFO - 2015-11-16 07:33:09,060 DEBUG : BROWSER_OUTPUT: Values: 215.0 212.0 215.0 214.0 210.0 212.0 211.0 211.0 209.0 209.0 07:33:09 INFO - 2015-11-16 07:33:09,060 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,061 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:99.20 Median:86.50 stddev:20.69 (23.9%) stddev-sans-first:21.10 07:33:09 INFO - 2015-11-16 07:33:09,061 DEBUG : BROWSER_OUTPUT: Values: 83.0 95.0 105.0 147.0 86.0 87.0 93.0 88.0 123.0 85.0 07:33:09 INFO - 2015-11-16 07:33:09,061 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,061 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:125.80 Median:114.50 stddev:21.27 (18.6%) stddev-sans-first:21.44 07:33:09 INFO - 2015-11-16 07:33:09,061 DEBUG : BROWSER_OUTPUT: Values: 107.0 113.0 155.0 113.0 114.0 114.0 153.0 113.0 115.0 161.0 07:33:09 INFO - 2015-11-16 07:33:09,061 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,061 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:154.00 Median:157.00 stddev:5.10 (3.2%) stddev-sans-first:5.29 07:33:09 INFO - 2015-11-16 07:33:09,062 DEBUG : BROWSER_OUTPUT: Values: 157.0 149.0 149.0 157.0 157.0 157.0 157.0 157.0 157.0 143.0 07:33:09 INFO - 2015-11-16 07:33:09,062 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,062 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:164.40 Median:165.00 stddev:0.70 (0.4%) stddev-sans-first:0.73 07:33:09 INFO - 2015-11-16 07:33:09,062 DEBUG : BROWSER_OUTPUT: Values: 164.0 164.0 165.0 164.0 165.0 163.0 165.0 165.0 164.0 165.0 07:33:09 INFO - 2015-11-16 07:33:09,062 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,062 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:131.00 Median:132.50 stddev:6.11 (4.6%) stddev-sans-first:5.75 07:33:09 INFO - 2015-11-16 07:33:09,063 DEBUG : BROWSER_OUTPUT: Values: 123.0 139.0 128.0 141.0 131.0 130.0 127.0 134.0 134.0 123.0 07:33:09 INFO - 2015-11-16 07:33:09,063 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,063 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:80.00 Median:80.50 stddev:3.43 (4.3%) stddev-sans-first:2.54 07:33:09 INFO - 2015-11-16 07:33:09,063 DEBUG : BROWSER_OUTPUT: Values: 73.0 78.0 79.0 80.0 81.0 80.0 81.0 87.0 80.0 81.0 07:33:09 INFO - 2015-11-16 07:33:09,063 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,065 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:90.20 Median:91.50 stddev:4.18 (4.6%) stddev-sans-first:2.82 07:33:09 INFO - 2015-11-16 07:33:09,065 DEBUG : BROWSER_OUTPUT: Values: 81.0 85.0 91.0 90.0 91.0 92.0 92.0 94.0 91.0 95.0 07:33:09 INFO - 2015-11-16 07:33:09,065 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,065 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:111.90 Median:112.50 stddev:1.52 (1.4%) stddev-sans-first:0.71 07:33:09 INFO - 2015-11-16 07:33:09,066 DEBUG : BROWSER_OUTPUT: Values: 108.0 113.0 112.0 111.0 112.0 112.0 112.0 113.0 113.0 113.0 07:33:09 INFO - 2015-11-16 07:33:09,066 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,066 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:168.30 Median:169.50 stddev:8.22 (4.8%) stddev-sans-first:8.66 07:33:09 INFO - 2015-11-16 07:33:09,066 DEBUG : BROWSER_OUTPUT: Values: 171.0 163.0 164.0 168.0 157.0 185.0 172.0 177.0 164.0 162.0 07:33:09 INFO - 2015-11-16 07:33:09,066 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,066 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:197.30 Median:200.00 stddev:5.79 (2.9%) stddev-sans-first:5.31 07:33:09 INFO - 2015-11-16 07:33:09,066 DEBUG : BROWSER_OUTPUT: Values: 189.0 202.0 203.0 200.0 200.0 199.0 202.0 198.0 194.0 186.0 07:33:09 INFO - 2015-11-16 07:33:09,067 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,067 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:90.60 Median:91.00 stddev:2.80 (3.1%) stddev-sans-first:1.66 07:33:09 INFO - 2015-11-16 07:33:09,067 DEBUG : BROWSER_OUTPUT: Values: 84.0 88.0 92.0 91.0 91.0 91.0 91.0 91.0 93.0 94.0 07:33:09 INFO - 2015-11-16 07:33:09,067 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:33:09 INFO - 2015-11-16 07:33:09,067 DEBUG : BROWSER_OUTPUT: 07:33:09 INFO - 2015-11-16 07:33:09,825 INFO : Browser exited with error code: 0 07:33:09 INFO - 2015-11-16 07:33:09,883 INFO : Completed test kraken (00:01:04) 07:33:09 INFO - 2015-11-16 07:33:09,883 INFO : Starting test v8_7 07:33:09 INFO - 2015-11-16 07:33:09,884 DEBUG : operating with platform_type : mac_ 07:33:09 INFO - 2015-11-16 07:33:09,884 INFO : Initialising browser for v8_7 test... 07:33:09 INFO - 2015-11-16 07:33:09,899 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/tmpRlXCgu/profile http://localhost:49268/getInfo.html 07:33:13 INFO - 2015-11-16 07:33:13,132 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:33:13 INFO - 2015-11-16 07:33:13,133 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:33:13 INFO - 2015-11-16 07:33:13,133 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 07:33:13 INFO - 2015-11-16 07:33:13,133 DEBUG : BROWSER_OUTPUT: __metrics 07:33:13 INFO - 2015-11-16 07:33:13,852 INFO : Browser initialized. 07:33:13 INFO - 2015-11-16 07:33:13,852 INFO : Running cycle 1/1 for v8_7 test... 07:33:13 INFO - 2015-11-16 07:33:13,852 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/tmpRlXCgu/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:33:26 INFO - 2015-11-16 07:33:26,137 DEBUG : BROWSER_OUTPUT: RSS: Main: 241532928 07:33:26 INFO - 2015-11-16 07:33:26,137 DEBUG : BROWSER_OUTPUT: 07:33:48 INFO - 2015-11-16 07:33:48,863 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49268/tests/v8_7/run.html (next: http://localhost:49268/tests/v8_7/run.html) 07:33:49 INFO - 2015-11-16 07:33:49,113 DEBUG : BROWSER_OUTPUT: RSS: Main: 261734400 07:33:49 INFO - 2015-11-16 07:33:49,113 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,113 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:33:49 INFO - 2015-11-16 07:33:49,113 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:33:49 INFO - 2015-11-16 07:33:49,113 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:33:49 INFO - 2015-11-16 07:33:49,114 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:33:49 INFO - 2015-11-16 07:33:49,114 DEBUG : BROWSER_OUTPUT: |0;Richards;907.4410163339383 07:33:49 INFO - 2015-11-16 07:33:49,114 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;242.5418384671356 07:33:49 INFO - 2015-11-16 07:33:49,114 DEBUG : BROWSER_OUTPUT: |2;Encrypt;405.0222762251924 07:33:49 INFO - 2015-11-16 07:33:49,114 DEBUG : BROWSER_OUTPUT: |3;Decrypt;7299.270072992701 07:33:49 INFO - 2015-11-16 07:33:49,114 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1371.2328767123288 07:33:49 INFO - 2015-11-16 07:33:49,115 DEBUG : BROWSER_OUTPUT: |5;Earley;995.0248756218906 07:33:49 INFO - 2015-11-16 07:33:49,115 DEBUG : BROWSER_OUTPUT: |6;Boyer;16451.612903225807 07:33:49 INFO - 2015-11-16 07:33:49,115 DEBUG : BROWSER_OUTPUT: |7;RegExp;35596.491228070176 07:33:49 INFO - 2015-11-16 07:33:49,115 DEBUG : BROWSER_OUTPUT: |8;Splay;859.106529209622 07:33:49 INFO - 2015-11-16 07:33:49,115 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;7070.422535211268 07:33:49 INFO - 2015-11-16 07:33:49,115 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:33:49 INFO - 2015-11-16 07:33:49,116 DEBUG : BROWSER_OUTPUT: __startTimestamp1447688029111__endTimestamp 07:33:49 INFO - 2015-11-16 07:33:49,116 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,116 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:33:49 INFO - 2015-11-16 07:33:49,116 DEBUG : BROWSER_OUTPUT: Number of tests: 10 07:33:49 INFO - 2015-11-16 07:33:49,116 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,116 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:907.44 Median:907.44 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,117 DEBUG : BROWSER_OUTPUT: Values: 907.4 07:33:49 INFO - 2015-11-16 07:33:49,117 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,117 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:242.54 Median:242.54 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,117 DEBUG : BROWSER_OUTPUT: Values: 242.5 07:33:49 INFO - 2015-11-16 07:33:49,117 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,118 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:405.02 Median:405.02 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,118 DEBUG : BROWSER_OUTPUT: Values: 405.0 07:33:49 INFO - 2015-11-16 07:33:49,118 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,118 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:7299.27 Median:7299.27 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,118 DEBUG : BROWSER_OUTPUT: Values: 7299.3 07:33:49 INFO - 2015-11-16 07:33:49,118 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,119 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1371.23 Median:1371.23 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,119 DEBUG : BROWSER_OUTPUT: Values: 1371.2 07:33:49 INFO - 2015-11-16 07:33:49,119 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,120 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:995.02 Median:995.02 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: Values: 995.0 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:16451.61 Median:16451.61 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: Values: 16451.6 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:35596.49 Median:35596.49 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: Values: 35596.5 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:859.11 Median:859.11 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: Values: 859.1 07:33:49 INFO - 2015-11-16 07:33:49,121 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,122 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:7070.42 Median:7070.42 stddev:0.00 (0.0%) 07:33:49 INFO - 2015-11-16 07:33:49,122 DEBUG : BROWSER_OUTPUT: Values: 7070.4 07:33:49 INFO - 2015-11-16 07:33:49,122 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:33:49 INFO - 2015-11-16 07:33:49,122 DEBUG : BROWSER_OUTPUT: 07:33:49 INFO - 2015-11-16 07:33:49,855 INFO : Browser exited with error code: 0 07:33:49 INFO - 2015-11-16 07:33:49,879 INFO : Completed test v8_7 (00:00:39) 07:33:49 INFO - 2015-11-16 07:33:49,983 INFO : Completed test suite (00:20:18) 07:33:49 INFO - 2015-11-16 07:33:49,983 DEBUG : Working with test: dromaeo_css 07:33:49 INFO - 2015-11-16 07:33:49,983 DEBUG : Generating results file: dromaeo_css 07:33:49 INFO - 2015-11-16 07:33:49,984 DEBUG : Working with test: kraken 07:33:49 INFO - 2015-11-16 07:33:49,984 DEBUG : Generating results file: kraken 07:33:49 INFO - 2015-11-16 07:33:49,984 INFO : javascript benchmark 07:33:49 INFO - 2015-11-16 07:33:49,984 DEBUG : Working with test: v8_7 07:33:49 INFO - 2015-11-16 07:33:49,984 DEBUG : Generating results file: v8_7 07:33:49 INFO - 2015-11-16 07:33:49,984 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:33:50 INFO - 2015-11-16 07:33:50,036 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,57]] 07:33:50 INFO - 2015-11-16 07:33:50,036 DEBUG : process_Request line: dromaeo_css 5404.38 graph.html#tests=[[72,64,57]] 07:33:50 INFO - 2015-11-16 07:33:50,036 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:33:50 INFO - 2015-11-16 07:33:50,079 DEBUG : process_Request line: kraken 1948.20 graph.html#tests=[[232,64,57]] 07:33:50 INFO - 2015-11-16 07:33:50,079 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:33:50 INFO - 2015-11-16 07:33:50,111 DEBUG : process_Request line: v8_7 13508.86 graph.html#tests=[[230,64,57]] 07:33:50 INFO - 2015-11-16 07:33:50,112 INFO : javascript benchmark 07:33:50 INFO - 2015-11-16 07:33:50,114 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [274.96837863645686, 275.50546768550464, 275.5536031628762, 279.5206221330418, 286.63740368433935, 11705.824412633818, 14263.71472570548, 14749.115053096823, 15011.699766004687, 15159.393624255017, 9528.523573821316, 9684.08001239881, 9821.901780982189, 13869.306534673276, 14189.432422703105, 3519.3841077811408, 3625.836837342326, 3658.3780757271193, 3691.2248427830186, 3695.519582454277, 3549.2723991581793, 3581.4627805829205, 3582.3551760683067, 3595.2270261893686, 3655.7806531608057, 2713.3623598454346, 2722.7005029446746, 3542.4509201073874, 3607.170350819313, 3857.5756666766633, 3927.9803600981954, 3952.980235098835, 3960.3861401482673, 3965.960340396588, 3988.8603898863544, 3299.868005279786, 3306.487494438366, 3313.4201514735064, 3348.497725341194, 3353.312570922955, 10331.0, 10613.257072004963, 10622.468876556219, 10623.097036751886, 10719.571217151304, 642.7043559962423, 1556.9766453503207, 1559.7816305717208, 1585.69871724372, 1660.692771837202, 7620.123685776096, 7649.655765490566, 7785.844283114363, 7814.960925195338, 7912.643931023118, 1291.8126871603658, 1305.4451857960423, 1306.6929271621161, 1323.4507679313074, 1345.9057865949387, 45997.77001115007, 47253.5274647256, 47441.28838067432, 47465.76267118642, 47843.76078119587, 5194.92207616886, 5225.190095535198, 5238.73806309683, 5293.258943747878, 5371.060064488699, 6014.88724585953, 6019.819405417845, 6024.0, 6036.15493830864, 6105.32841387447, 4231.386448964883, 4251.29853574163, 4282.892927676833, 4288.378185163134, 4335.978320108442, 4250.638695710837, 4250.893727656833, 4327.545607711208, 4439.600435960779, 4447.399601053817, 2342.695449591542, 2368.810495160383, 2380.785729284373, 2396.724376696702, 2402.9759702402753, 844.4511067805976, 850.7915560687671, 855.5123579559715, 865.8138500222483, 909.0, 349.1707195410899, 362.8421636588093, 364.36600315450926, 366.8349242840679, 370.4295385106905, 9019.098090190928, 9464.0, 9546.42721436716, 9559.426434413957, 9631.08504692053, 372.9962700373016, 374.80322830513654, 380.1560535610939, 383.6240484325377, 395.1760579192416, 5009.7244651544515, 5128.564072053842, 5203.0, 5208.296879921162, 5267.157254839208, 319192.0, 331381.0, 367031.0, 449877.0, 481119.0, 53961.1905821413, 57589.424105759244, 58073.41926580764, 58838.41161588415, 59301.703491482265, 400.8136216659209, 409.0305974839649, 410.01391653075, 410.24514892597165, 411.3788179848391, 8768.561571921506, 8864.42381245217, 8892.911070889468, 8909.55452227399, 8996.820063598821, 28188.71811281861, 28582.857085714437, 28617.570736439386, 28939.131826045254, 29274.853625731736, 38577.0, 38979.0, 39430.282609022106, 39598.60401395949, 39896.60103398929, 4862.610991120631, 4948.208286674115, 4962.751862406937, 4994.9750251248515, 5000.57495112905, 9037.909620903707, 9178.862317065383, 9204.539773011189, 9344.579493922654, 9523.714288571355, 7945.364370850433, 8162.632681529227, 8206.343492520704, 8266.669333226844, 8294.253517183482, 6895.138107736533, 7391.40868730511, 7426.183119856703, 7992.960035199787, 8098.433109682265, 8114.634841432267, 8253.83492330162, 8331.083580805986, 8353.624086916225, 8434.915650843413, 5016.72408017548, 5019.974900125476, 5036.269740887624, 5058.0, 5125.564327032244, 7988.121306656147, 8254.917450825655, 8337.374696897636, 8393.454425462325, 8423.4945903246], "dojo.html": [2523.7476252374763, 2584.638150658908, 2648.7351264873528, 2689.354554906823, 2689.8789554470045, 4436.645068394525, 4438.822447102116, 4472.7987240574175, 4493.4158559387315, 4503.482099558551, 4277.721948073381, 4387.648988080954, 4390.802413891374, 4458.464984201901, 4512.59386655201, 4031.3146765049937, 4106.548279689232, 4108.26051310764, 4124.814383352741, 4185.330347144458, 512.3420783433351, 3990.3615421532418, 4110.157417729359, 4155.58444155585, 4292.055747735509, 4043.4945631796027, 4079.1637714268504, 4101.712880098395, 4105.0, 4151.335786274181, 4095.4266402703647, 4102.179564087165, 4124.505059392862, 4134.91730165398, 4203.369494575808, 3951.723379363446, 3964.088259700285, 4050.3114470539786, 4095.0, 4129.525104612978, 4234.9364759528635, 4390.604845563883, 4402.581754733295, 4405.757683327416, 4504.0, 4674.228752255874, 4675.438947326308, 4676.251799712064, 4698.859034228979, 4797.784099715521, 4614.653900957442, 4652.302154676791, 4755.904881902377, 4781.3784208053075, 4818.012307476959, 4438.289873620205, 4457.442819647544, 4460.330950357407, 4469.44131983502, 4557.794899229542, 4917.139500587383, 4926.137925863031, 4942.0363029209675, 4945.876353091202, 4987.202047672355, 4467.30756732707, 4500.0, 4556.635469162459, 4568.246239370533, 4676.08816280822, 4679.812807487662, 4681.836135735233, 4751.857444276678, 4811.615070794328, 4822.903541929212, 4518.322251662277, 4588.059447813191, 4661.067786442725, 4680.602148817321, 4709.952900470951, 4593.127305811885, 4637.837675681402, 4686.179918514246, 4699.78850951708, 4749.691270067435, 3640.162762564625, 3656.5246517952496, 3660.6888414484533, 3670.522832031819, 3685.539307586552, 3234.2884565395575, 3281.704646581819, 3366.074329559342, 3374.4938259261307, 3386.339663765542, 4367.410399596014, 4371.650267978554, 4452.287633978548, 4489.73061616304, 4496.505384407713, 4787.305840653085, 4827.637927155407, 4831.275308703653, 4852.175130227799, 4895.118878601815, 4326.848560300437, 4372.650187984954, 4442.8222871085445, 4513.368128462018, 4528.88677783058, 4192.413062171298, 4199.727017743837, 4204.327307630764, 4213.389058586487, 4233.618974292329, 4823.083614113378, 4901.215805471107, 4923.310736496894, 4927.0, 4982.8754281143265, 4567.200739870443, 4619.514950930104, 4744.596709279612, 4772.570468657837, 4790.8323208687525, 4943.456219815889, 4958.45456999737, 4988.052270068675, 4999.0501804657, 5030.220315851049, 4702.0360826031265, 4721.5750582447745, 4722.858314250578, 4745.335653008513, 4757.286407038833, 4550.704204226715, 4571.085782843378, 4691.179043667413, 4739.0, 4772.164871147605, 4631.745254010927, 4640.396748422683, 4651.604613607881, 4678.134545109029, 4756.524347565216, 4461.866144015685, 4642.953570464252, 4650.4186976627925, 4659.65052621048, 4706.835260765857, 4486.506484286791, 4567.771611419482, 4576.153411618728, 4631.907361852812, 4650.86047418578, 4266.402703621434, 4687.648426367968, 4696.600788932979, 4712.50518695532, 4747.335373047707, 4458.621017213443, 4495.100979804118, 4624.190766615761, 4637.744924029076, 4638.698484598491], "mootools.html": [1436.6552027513396, 1463.7996842589082, 1475.4172102019702, 1494.5740463967766, 1510.2750679673752, 5672.092465205568, 6045.486133678632, 6221.284552276484, 6633.568818026825, 6654.500912431568, 6204.96897515513, 6364.045393191023, 6466.030095485679, 6504.154459920203, 6513.837154071139, 1827.7441158237857, 1856.2111102781332, 1856.9071546422624, 1856.9972215003882, 1860.8604354673453, 1838.9080545972715, 1854.5549068223663, 1866.0762922353454, 1885.9434216973514, 1890.3289332287047, 1832.853371730265, 1856.9071546422692, 1859.953501162475, 1862.5995410986636, 1866.7479890214852, 1779.8932064076132, 1818.0818686563334, 1822.7812662480587, 1824.771903512061, 1825.698759704647, 1828.3509354179341, 1842.178715259786, 1852.2498388152685, 1879.2576932111876, 1881.8400435962822, 6411.3588641135975, 6507.251666058369, 6508.511861610398, 6514.57655252407, 6515.250746164157, 4034.495688038995, 4099.0, 4120.979395103005, 4121.093359460914, 4139.151473947833, 2305.319930620454, 2330.52224294021, 2374.228375777879, 2374.8575085494926, 2383.5709572276983, 737.9520331178456, 739.9038125043763, 748.8577170337618, 762.230147550972, 779.516699646223, 8546.52994085325, 8556.657733690645, 8562.700305489278, 8568.485890846507, 8582.313414926792, 3558.768680035789, 3620.728445366608, 3682.0978860179425, 3709.4621279914263, 3720.479132921393, 7377.741779037815, 7384.372328352043, 7404.111506619241, 7405.074365704287, 7474.065741782278, 4065.3698676705158, 4076.3681629346906, 4085.264652362603, 4095.4266402703647, 4140.710150289451, 3320.236345640468, 3416.197193659488, 3701.833417496165, 3707.1658876753054, 3737.289914916157, 3040.3767227718263, 3139.9058028259187, 3140.4661207594763, 3146.465100932847, 3154.0, 966.3573723473952, 1023.4933707814531, 1027.6762819711766, 1039.6828967165088, 1039.9688009359731, 852.6376290076693, 871.9171678690515, 882.0429833630583, 882.668999125328, 1131.7736452709491, 5989.341172471025, 6056.273247210363, 6065.150878876961, 6152.3540028297275, 6182.350853160354, 936.166811537732, 954.3271993244746, 960.8991055939166, 974.0746291023556, 978.574320170728, 4464.665150113755, 4528.207563676344, 4583.495815460296, 4634.791434385461, 4681.7190968542, 7402.592857392895, 7550.471466997367, 7601.505902116345, 7666.386689064973, 7764.6894124234395, 7377.557346559223, 7464.70141194357, 7488.063992001, 7596.240375962359, 7606.163322034572, 5927.2590926134235, 6054.152418661391, 6074.362191969868, 6125.111858780452, 6140.078988151724, 5745.7988970387505, 5750.022496175577, 5762.337331206965, 5802.448767367094, 5835.307760749335, 6486.54594178403, 6698.430633396216, 6743.0, 6785.762498312535, 6812.14848143982, 6780.69486873082, 6929.757458488929, 6937.930620693728, 6985.476089293425, 7019.508634395544, 4850.6119510438375, 5197.168453047494, 5651.915221271602, 5689.288838895138, 5761.164631128547, 5626.212330273683, 5981.850453738517, 5991.730372133177, 6027.60820546663, 6085.0, 5649.096144616841, 5672.347680016851, 5695.658260504383, 5772.1630363596205, 5810.7094645266725, 5595.969232603848, 5692.31692196939, 5699.458551437772, 5712.6286791358425, 5715.085586306171, 5719.5138413235345, 5759.366469688414, 5786.884262314646, 5792.21805056312, 5794.072948328416, 5145.536901678867, 5244.9737751310995, 5254.763535640982, 5274.76263568148, 5276.050310944067, 5283.181106928432, 5295.099833028471, 5302.920456193083, 5330.227117067926, 5330.573554115584], "ext.html": [456.4385805459285, 470.48951887202384, 477.93659108483627, 483.9709617422957, 492.7462356886202, 31798.36403271936, 32392.19019524507, 32399.0, 32400.351992960157, 32809.83595082027, 34749.47875781865, 34837.651623483755, 34889.30221395571, 35342.0, 35391.823040884825, 7581.279778421042, 7639.083310002808, 7652.808679782995, 7674.424418168632, 7773.300402963732, 7464.402847772192, 7564.054493188351, 7677.117131529862, 7681.3086822186, 7712.652930618107, 7500.54996700197, 7513.849723005564, 7610.581418022007, 7636.618169091551, 7673.194314596971, 7554.320111189992, 7629.65666545004, 7656.464047516676, 7685.730999415049, 7729.149793522708, 7379.298966598165, 7526.09686837583, 7537.660805263777, 7646.082470103624, 7653.579053152074, 32499.0, 32977.505337419956, 32987.835060824786, 33184.3363132736, 33461.49807752886, 2075.823554997827, 2173.7717539658424, 2222.344408399526, 2421.2857207123766, 2537.1373732930706, 21900.23349182787, 22355.552888942293, 22782.772172278397, 23275.650865237036, 23500.647490287658, 1947.4936516505668, 1967.980320196794, 1971.7831038585743, 1992.5118346005322, 2001.3395579458743, 201885.0, 202190.0, 202760.0, 202954.0, 203876.0, 33264.83367583147, 33680.326393471994, 33715.15712107217, 34153.31693366119, 34321.65678343234, 33509.66490335114, 33538.32923341519, 33598.30418653946, 33945.830270848484, 34110.0, 10807.513661885234, 10832.512536935857, 10835.404052777016, 10860.891391085988, 11013.229073964745, 8353.289970352587, 8462.576871156418, 8490.702825401206, 8511.446755960842, 8643.049264580892, 11355.37545435009, 11406.714832129097, 11421.0, 11423.257488263236, 11470.0, 5103.7192954387865, 5195.168772996302, 5233.921491177635, 5244.554212891947, 5258.1849813279005, 781.6873250699765, 806.3992325717378, 806.8386322735477, 844.8437039147777, 863.4344504349662, 22369.217077402212, 22782.0, 22938.541229175324, 23094.42263943415, 23303.0, 829.3116713128089, 848.410354803418, 854.9487030778173, 857.8584533552018, 864.6800683746928, 11511.079113670887, 11657.417129143509, 11666.125040621988, 11794.705132371759, 11835.763284734428, 324486.0, 331471.0, 334419.0, 334737.0, 336432.0, 43320.0, 43923.78038109853, 44232.3365149523, 44653.55346446559, 44661.55338446639, 1119.6081371519904, 1123.640435060789, 1128.700894263021, 1129.824877144044, 1152.740633357488, 21486.462838429165, 22053.22813701513, 22297.219597314015, 22386.0, 22439.21462748796, 36343.0, 36595.26809463849, 36858.44712329264, 37001.44497832588, 37049.25901482009, 227075.0, 229610.0, 230734.0, 231781.0, 232522.0, 25541.48917021612, 25672.871635641703, 35187.82406087953, 37471.81264093662, 37603.623963760016, 35722.285554288246, 35833.28333433265, 35947.46078808872, 36112.81943590265, 36133.27733445369, 28640.283992900346, 30444.0, 30687.2328191797, 30794.38411231718, 31846.68153318437, 29449.85275073611, 29661.258468537595, 29732.256693582833, 29982.400351993274, 30215.848920755256, 29288.0, 29878.0, 30113.0, 30342.393152137276, 30354.84822575873, 26029.869850650626, 27305.863470682518, 28136.43727125487, 28645.427091457637, 28732.281692957007, 19469.318573849847, 19885.204591816164, 19902.70145947841, 19922.103505342006, 20074.096665649788], "prototype.html": [252.49878990204454, 255.96800399950004, 259.02477173441986, 264.4750170910743, 267.3130055756704, 5084.593232541397, 5086.643934924557, 5225.163973764198, 5254.290670759447, 5254.894902101961, 4995.625328100398, 5135.486451354872, 5196.948030519694, 5213.635045546814, 5261.552768014723, 3952.584978577251, 3959.2081583683234, 3959.386295124253, 3960.841566337343, 4007.2386246613196, 3955.564887862333, 3962.029302820813, 3966.9206615867665, 4022.7184097113213, 4047.2310261050307, 3808.7143464240294, 3920.137569734668, 3932.665723413513, 3935.5080614923136, 3975.4434379186937, 3876.9806150969207, 3879.437481565157, 3900.0, 3949.3878448840474, 3956.4460975463458, 3369.107186595554, 3371.2751758371824, 3372.207531230159, 3392.457206846893, 3407.829608519589, 4830.2030165022725, 4851.369321988119, 4987.625928055374, 4989.226669866177, 5066.316047333599, 4421.602055814992, 4434.33484977256, 4437.356583295436, 4438.911221775578, 4443.200223959686, 5418.783248670048, 5443.727813609304, 5463.508284254436, 5514.007478653841, 5518.33779946405, 3655.342038433081, 3656.9085772855624, 3680.4663323818163, 3725.9441108383394, 3729.981350093259, 5613.90528846875, 5748.281464816898, 5766.971165144148, 5830.825075247707, 5831.212786273841, 3638.1086633774894, 3654.470101835219, 3667.1932174921476, 3700.5744339400776, 3729.5151630288433, 3736.663700266989, 3746.213295208037, 3760.7179461539945, 3769.246150769857, 3791.1090893640526, 4370.453693288339, 4380.145871555016, 4424.491183513937, 4442.644588432918, 4451.910961780746, 5416.0792665247, 5422.349318081855, 5486.6982315973, 5548.0, 5561.274975262092, 1303.7066660001612, 1308.784050631654, 1310.0763961407185, 1327.0445279398818, 1327.3097989045643, 835.9247667709935, 837.1670188162817, 840.1346612988632, 844.9704260350858, 861.573521107056, 5289.47105289468, 5335.599830012765, 5336.946630533645, 5352.223927530486, 5357.919631205535, 5715.199872017921, 5727.799527016535, 5793.420657934173, 5797.826065218051, 5799.5070419014855, 5311.123664595376, 5318.9202161967605, 5327.920081198785, 5334.1732031535175, 5367.087595108841, 3029.1366960416176, 3091.30445649727, 3097.659257481675, 3097.9776673697625, 3123.4846250368887, 5896.174535565025, 5918.526517878559, 5968.432998865101, 5970.582059255898, 6000.219971403777, 5650.915236271459, 5737.88524229513, 5825.621334613322, 5923.526117910556, 5936.406359364116, 5916.787058652966, 5970.791022314198, 6068.150458935753, 6073.635581864925, 6081.483073938764, 5767.077267637158, 5768.653880767168, 5776.971115144397, 5836.328822185503, 5842.38654941225, 5552.805651802168, 5601.551875849841, 5633.324001119892, 5697.4302569742695, 5710.029295019774, 5954.166416701579, 5957.434043765836, 6017.729202185825, 6023.48800351975, 6029.095635654511, 3663.5420572428447, 3684.1894783147663, 3685.4840322355426, 3737.7009839212255, 3738.943915841319, 5713.400092990176, 5717.113847353667, 5780.94219057804, 5797.4782269595935, 5801.303843538633, 5440.755166017618, 5547.084731019337, 5579.637323573955, 5606.0469720148485, 5635.239242702347, 5539.8892022158525, 5544.1960915667805, 5549.72251387421, 5636.0, 5681.488666020078, 5420.457954204706, 5463.590230732791, 5503.972480137734, 5509.614326997232, 5511.0, 5300.072487314627, 5546.7781288748, 5552.194931734956, 5580.35825880029, 5631.070873306023, 5441.401445840876, 5455.8363249102595, 5493.7802487900035, 5516.862078447911, 5520.254765606592], "yui.html": [607.7903123422418, 613.4172536090712, 618.6411881108958, 625.6996641612023, 632.3202557250955, 10519.684409467718, 11040.723981900437, 11145.888541114597, 11168.553257869697, 11244.606438774645, 10469.31949423287, 10647.414392208426, 10732.678019659403, 10779.676609701703, 10786.298890572127, 561.3488353509929, 579.3048341989629, 703.3810246982661, 720.1682057223915, 721.606724335236, 702.5433468245656, 715.3561794385043, 723.6598798564693, 724.3480867219519, 724.5037149552547, 734.7024455095694, 763.7441457111875, 764.2930289482234, 764.9694012239504, 765.5024234247755, 747.6934456872656, 758.6813538313921, 759.0701390796286, 760.106874422554, 765.1545042727789, 561.612487383704, 567.1492760858712, 571.9428057194248, 572.0532518681589, 572.1303618499899, 10878.72803179919, 11182.273152245078, 11201.0, 11219.60731374398, 11244.325340479598, 9174.128457796498, 9271.211946984515, 9570.808583828353, 9900.80198396028, 9906.702798915972, 7583.317501424843, 7761.8447631047065, 7824.906651021478, 8019.839603207962, 8187.38594605407, 2679.8660066996767, 2771.2240572639694, 2781.7496425321615, 2791.623130877326, 2799.4261176458776, 38533.0, 38586.0, 38643.0, 39264.803675981726, 40646.59353406487, 7317.487775855639, 7340.853182936311, 7367.594782286918, 7377.823542055106, 7429.8688495204915, 9613.230941524662, 9686.418814870989, 15551.766723499157, 15738.842611573968, 15855.365785368456, 5141.76862041209, 5185.559227465707, 5320.441353657888, 5342.91985620216, 5349.893002139936, 3004.8948286809855, 3050.527168288919, 3051.1761824307314, 3086.27472543952, 3125.1874512626882, 2156.9784302156777, 2182.7489838668757, 2209.712737344135, 2216.789405006522, 2227.7438094619, 327.54307740701586, 332.0817938400325, 336.5607881714386, 337.6522182152387, 341.7112539903777, 400.6494317472212, 419.0153140120692, 460.53485979161286, 475.8596214116844, 525.3433208489388, 6233.470155036782, 6691.26396096429, 6762.289959554176, 6787.694553745093, 6794.72821087151, 377.6289449620652, 429.1802656925258, 489.6523468337449, 492.25423483422645, 495.1953076251092, 3120.1731541141617, 3155.984220078931, 3176.2059485128716, 3184.092533627905, 3189.8086114833186, 49602.75198623984, 49727.75136124369, 49914.50085499171, 50109.24836127388, 50139.74930125326, 38157.0, 38416.23167536633, 38624.42063369052, 38683.41974870379, 38785.80607097003, 37850.43224351637, 37892.810535947145, 38593.807030964665, 39137.41293880594, 39624.60375396209, 6768.729250830109, 6812.250652428328, 6854.143232095988, 6868.484863635147, 6986.371226589428, 27576.724232758217, 27941.860290698416, 28910.566341505313, 29500.557491638072, 29720.0, 37624.43563346497, 37697.62302376941, 38221.0, 38665.6133438662, 39117.60882391254, 5928.229330187048, 6109.877802444015, 6260.87304285233, 6332.493400528039, 6337.96831015842, 9003.414778039407, 9086.45481271126, 9209.355345125778, 9288.860667090134, 9694.660686875926, 8444.831103378021, 8563.95718021406, 8880.067592902653, 8910.242629376575, 9165.312601555044, 8674.522901240493, 8741.300695944436, 8829.779255518664, 8952.14954579314, 8983.91016089857, 8423.241908228289, 8425.368097392597, 8437.240648341678, 8655.610497527501, 8860.468371897707, 7460.0, 7574.3183113520045, 7678.117016542946, 7697.307242348215, 7874.960625196837, 7461.888071678821, 7536.0956685198125, 7578.507397019176, 7899.249571290718, 7945.284924356835]}, "summary": {"lowerIsBetter": false, "suite": 5404.376501471895, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 5320.730700230342, "unit": "ms", "value": 5320.730700230342}, "dojo.html": {"lowerIsBetter": false, "filtered": 4363.278117921388, "unit": "ms", "value": 4363.278117921388}, "mootools.html": {"lowerIsBetter": false, "filtered": 3687.9142827178016, "unit": "ms", "value": 3687.9142827178016}, "ext.html": {"lowerIsBetter": false, "filtered": 14476.569710442714, "unit": "ms", "value": 14476.569710442714}, "prototype.html": {"lowerIsBetter": false, "filtered": 4108.390090211742, "unit": "ms", "value": 4108.390090211742}, "yui.html": {"lowerIsBetter": false, "filtered": 4892.490905338347, "unit": "ms", "value": 4892.490905338347}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0065.e"}, "testrun": {"date": 1447686811, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151116053834", "branch": "Fx-Team", "revision": "a642464a44992122f55bbe919db79b93bfec485b"}}, {"talos_counters": {}, "results": {"audio-dft": [215.0, 212.0, 215.0, 214.0, 210.0, 212.0, 211.0, 211.0, 209.0, 209.0], "ai-astar": [134.0, 133.0, 140.0, 139.0, 139.0, 151.0, 140.0, 140.0, 138.0, 132.0], "imaging-gaussian-blur": [157.0, 149.0, 149.0, 157.0, 157.0, 157.0, 157.0, 157.0, 157.0, 143.0], "audio-beat-detection": [188.0, 170.0, 194.0, 212.0, 172.0, 191.0, 188.0, 164.0, 205.0, 167.0], "json-stringify-tinderbox": [81.0, 85.0, 91.0, 90.0, 91.0, 92.0, 92.0, 94.0, 91.0, 95.0], "stanford-crypto-pbkdf2": [189.0, 202.0, 203.0, 200.0, 200.0, 199.0, 202.0, 198.0, 194.0, 186.0], "json-parse-financial": [73.0, 78.0, 79.0, 80.0, 81.0, 80.0, 81.0, 87.0, 80.0, 81.0], "stanford-crypto-sha256-iterative": [84.0, 88.0, 92.0, 91.0, 91.0, 91.0, 91.0, 91.0, 93.0, 94.0], "audio-fft": [83.0, 95.0, 105.0, 147.0, 86.0, 87.0, 93.0, 88.0, 123.0, 85.0], "imaging-darkroom": [164.0, 164.0, 165.0, 164.0, 165.0, 163.0, 165.0, 165.0, 164.0, 165.0], "stanford-crypto-ccm": [171.0, 163.0, 164.0, 168.0, 157.0, 185.0, 172.0, 177.0, 164.0, 162.0], "audio-oscillator": [107.0, 113.0, 155.0, 113.0, 114.0, 114.0, 153.0, 113.0, 115.0, 161.0], "stanford-crypto-aes": [108.0, 113.0, 112.0, 111.0, 112.0, 112.0, 112.0, 113.0, 113.0, 113.0], "imaging-desaturate": [123.0, 139.0, 128.0, 141.0, 131.0, 130.0, 127.0, 134.0, 134.0, 123.0]}, "summary": {"lowerIsBetter": true, "suite": 1948.2, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 99.2, "unit": "ms", "value": 99.2}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 197.3, "unit": "ms", "value": 197.3}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 185.1, "unit": "ms", "value": 185.1}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 168.3, "unit": "ms", "value": 168.3}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 164.4, "unit": "ms", "value": 164.4}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 80.0, "unit": "ms", "value": 80.0}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 125.8, "unit": "ms", "value": 125.8}, "ai-astar": {"lowerIsBetter": true, "filtered": 138.6, "unit": "ms", "value": 138.6}, "audio-dft": {"lowerIsBetter": true, "filtered": 211.8, "unit": "ms", "value": 211.8}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 90.6, "unit": "ms", "value": 90.6}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 90.2, "unit": "ms", "value": 90.2}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 154.0, "unit": "ms", "value": 154.0}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 111.9, "unit": "ms", "value": 111.9}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 131.0, "unit": "ms", "value": 131.0}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0065.e"}, "testrun": {"date": 1447686811, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151116053834", "branch": "Fx-Team", "revision": "a642464a44992122f55bbe919db79b93bfec485b"}}, {"talos_counters": {}, "results": {"DeltaBlue": [242.5418384671356], "Encrypt": [405.0222762251924], "NavierStokes": [7070.422535211268], "Decrypt": [7299.270072992701], "Splay": [859.106529209622], "Richards": [907.4410163339383], "RegExp": [35596.491228070176], "Earley": [995.0248756218906], "Boyer": [16451.612903225807], "RayTrace": [1371.2328767123288]}, "summary": {"lowerIsBetter": false, "suite": 13508.863148025315, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 272.60451399999994, "unit": "score", "value": 272.60451399999994}, "Encrypt": {"lowerIsBetter": false, "filtered": 657.2008889999998, "unit": "score", "value": 657.2008889999998}, "NavierStokes": {"lowerIsBetter": false, "filtered": 209.8884462151396, "unit": "score", "value": 209.8884462151396}, "Decrypt": {"lowerIsBetter": false, "filtered": 36.466797000000014, "unit": "score", "value": 36.466797000000014}, "Splay": {"lowerIsBetter": false, "filtered": 94.85552399999997, "unit": "score", "value": 94.85552399999997}, "RegExp": {"lowerIsBetter": false, "filtered": 25.59198866436668, "unit": "score", "value": 25.59198866436668}, "Richards": {"lowerIsBetter": false, "filtered": 38.90280400000002, "unit": "score", "value": 38.90280400000002}, "Earley": {"lowerIsBetter": false, "filtered": 669.7953149999997, "unit": "score", "value": 669.7953149999997}, "Boyer": {"lowerIsBetter": false, "filtered": 40.510496078431345, "unit": "score", "value": 40.510496078431345}, "RayTrace": {"lowerIsBetter": false, "filtered": 539.6523176823176, "unit": "score", "value": 539.6523176823176}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0065.e"}, "testrun": {"date": 1447686811, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151116053834", "branch": "Fx-Team", "revision": "a642464a44992122f55bbe919db79b93bfec485b"}}] 07:33:50 INFO - RETURN: dromaeo_css: 5404.38 07:33:50 INFO - RETURN: kraken: 1948.20 07:33:50 INFO - RETURN: v8_7: 13508.86 07:33:50 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,57]]", "result": "13508.86"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,57]]", "result": "1948.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,57]]", "result": "5404.38"}}} 07:33:50 INFO - Return code: 0 07:33:50 INFO - # TBPL SUCCESS # 07:33:50 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 07:33:50 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 07:33:50 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 07:33:50 INFO - 2015-11-16 07:33:50.221 screenresolution[1679:10976] starting screenresolution argv=screenresolution get 07:33:50 INFO - 2015-11-16 07:33:50.225 screenresolution[1679:10976] Display 0: 1600x1200x32@60 07:33:50 INFO - 2015-11-16 07:33:50.233 screenresolution[1680:10979] starting screenresolution argv=screenresolution list 07:33:50 INFO - Available Modes on Display 0 07:33:50 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 07:33:50 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 07:33:50 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 07:33:50 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 07:33:50 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 07:33:50 INFO - Intel HD Graphics 3000: 07:33:50 INFO - Chipset Model: Intel HD Graphics 3000 07:33:50 INFO - Type: GPU 07:33:50 INFO - Bus: Built-In 07:33:50 INFO - VRAM (Total): 512 MB 07:33:50 INFO - VRAM (Dynamic, Max): 10 07:33:50 INFO - Vendor: Intel (0x8086) 07:33:50 INFO - Device ID: 0x0116 07:33:50 INFO - Revision ID: 0x0009 07:33:50 INFO - Displays: 07:33:50 INFO - Display: 07:33:50 INFO - Resolution: 1600 x 1200 @ 60 Hz 07:33:50 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 07:33:50 INFO - Display Serial Number: 1600x1200 60 07:33:50 INFO - Main Display: Yes 07:33:50 INFO - Mirror: Off 07:33:50 INFO - Online: Yes 07:33:50 INFO - Rotation: Supported 07:33:50 INFO - Return code: 0 07:33:50 INFO - Running post-action listener: _resource_record_post_action 07:33:50 INFO - Running post-run listener: _resource_record_post_run 07:33:51 INFO - Total resource usage - Wall time: 1263s; CPU: 30.0%; Read bytes: 41538560; Write bytes: 694200320; Read time: 6181; Write time: 61788 07:33:51 INFO - install - Wall time: 44s; CPU: 30.0%; Read bytes: 339665408; Write bytes: 338440192; Read time: 38206; Write time: 6293 07:33:51 INFO - run-tests - Wall time: 1220s; CPU: 30.0%; Read bytes: 39769088; Write bytes: 345389056; Read time: 5889; Write time: 55030 07:33:51 INFO - Running post-run listener: _upload_blobber_files 07:33:51 INFO - Blob upload gear active. 07:33:51 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 07:33:51 INFO - Copying logs to upload dir... 07:33:51 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1325.276582 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 5 secs) (at 2015-11-16 07:33:51.691291) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-16 07:33:51.694693) ========= 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.HkIrKdm96l/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.Wnpav1E41p/Listeners TMPDIR=/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False build_url:https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011275 build_url: 'https://queue.taskcluster.net/v1/task/wnpTCeNiTBCBenbBvL0DUw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-16 07:33:51.723923) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 07:33:51.724312) ========= 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.HkIrKdm96l/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.Wnpav1E41p/Listeners TMPDIR=/var/folders/k6/9hphd7gs4278sn2y47gp8p0w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.006030 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 07:33:51.774673) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-16 07:33:51.775034) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-16 07:33:51.775523) ========= ========= Total master_lag: 13.27 =========