builder: mozilla-inbound_yosemite_test-dromaeojs slave: t-yosemite-r5-0093 starttime: 1447147926.12 results: success (0) buildid: 20151110000603 builduid: f90fd593a93f4a8884557765fe8002f4 revision: 180b1c201aa2ec9277207d76341c9b60254c80b4 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.116402) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.116912) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.117252) ========= 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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners TMPDIR=/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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.005942 basedir: '/builds/slave/test' ========= master_lag: 0.08 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.201467) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.201828) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.398814) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.399238) ========= 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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners TMPDIR=/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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.005491 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.455453) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.455810) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.456236) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.456546) ========= 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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners TMPDIR=/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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-10 01:32:06-- 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% 1.41G=0s 2015-11-10 01:32:06 (1.41 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.358744 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.835511) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.835867) ========= 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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners TMPDIR=/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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.019877 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:06.886795) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-10 01:32:06.887225) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 180b1c201aa2ec9277207d76341c9b60254c80b4 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 180b1c201aa2ec9277207d76341c9b60254c80b4 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.3xhO3nTEEq/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.Iqai9CkTJV/Listeners TMPDIR=/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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-10 01:32:06,960 truncating revision to first 12 chars 2015-11-10 01:32:06,960 Setting DEBUG logging. 2015-11-10 01:32:06,960 attempt 1/10 2015-11-10 01:32:06,961 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/180b1c201aa2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-10 01:32:08,498 unpacking tar archive at: mozilla-inbound-180b1c201aa2/testing/mozharness/ program finished with exit code 0 elapsedTime=1.786797 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-10 01:32:08.691378) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:08.691803) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:08.705576) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:08.706027) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-10 01:32:08.706908) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 1 secs) (at 2015-11-10 01:32:08.707249) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.3xhO3nTEEq/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.Iqai9CkTJV/Listeners TMPDIR=/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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 01:32:08 INFO - MultiFileLogger online at 20151110 01:32:08 in /builds/slave/test 01:32:08 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 01:32:08 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 01:32:08 INFO - {'append_to_log': False, 01:32:08 INFO - 'base_work_dir': '/builds/slave/test', 01:32:08 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 01:32:08 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 01:32:08 INFO - 'branch': 'Mozilla-Inbound', 01:32:08 INFO - 'buildbot_json_path': 'buildprops.json', 01:32:08 INFO - 'config_files': ('talos/mac_config.py',), 01:32:08 INFO - 'default_actions': ('clobber', 01:32:08 INFO - 'read-buildbot-config', 01:32:08 INFO - 'download-and-extract', 01:32:08 INFO - 'populate-webroot', 01:32:08 INFO - 'create-virtualenv', 01:32:08 INFO - 'install', 01:32:08 INFO - 'run-tests'), 01:32:08 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 01:32:08 INFO - 'download_minidump_stackwalk': True, 01:32:08 INFO - 'download_symbols': 'ondemand', 01:32:08 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 01:32:08 INFO - 'tooltool.py': '/tools/tooltool.py', 01:32:08 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 01:32:08 INFO - '/tools/misc-python/virtualenv.py')}, 01:32:08 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 01:32:08 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 01:32:08 INFO - 'installer_path': 'installer.exe', 01:32:08 INFO - 'log_level': 'info', 01:32:08 INFO - 'log_name': 'talos', 01:32:08 INFO - 'log_to_console': True, 01:32:08 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 01:32:08 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 01:32:08 INFO - 'opt_config_files': (), 01:32:08 INFO - 'pip_index': False, 01:32:08 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 01:32:08 INFO - 'cmd': ('bash', 01:32:08 INFO - '-c', 01:32:08 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 01:32:08 INFO - 'enabled': True, 01:32:08 INFO - 'halt_on_failure': False, 01:32:08 INFO - 'name': 'check_screen_resolution'},), 01:32:08 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 01:32:08 INFO - 'cmd': ('bash', 01:32:08 INFO - '-c', 01:32:08 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 01:32:08 INFO - 'enabled': True, 01:32:08 INFO - 'halt_on_failure': False, 01:32:08 INFO - 'name': 'check_screen_resolution'},), 01:32:08 INFO - 'run_cmd_checks_enabled': True, 01:32:08 INFO - 'sps_profile': False, 01:32:08 INFO - 'sps_profile_interval': 0, 01:32:08 INFO - 'suite': 'dromaeojs', 01:32:08 INFO - 'system_bits': '64', 01:32:08 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 01:32:08 INFO - 'title': 't-yosemite-r5-0093', 01:32:08 INFO - 'tooltool_cache': '/builds/tooltool_cache', 01:32:08 INFO - 'use_talos_json': True, 01:32:08 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 01:32:08 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 01:32:08 INFO - 'work_dir': 'build'} 01:32:08 INFO - ##### 01:32:08 INFO - ##### Running clobber step. 01:32:08 INFO - ##### 01:32:08 INFO - Running pre-action listener: _resource_record_pre_action 01:32:08 INFO - Running main action method: clobber 01:32:08 INFO - rmtree: /builds/slave/test/build 01:32:08 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 01:32:10 INFO - Running post-action listener: _resource_record_post_action 01:32:10 INFO - ##### 01:32:10 INFO - ##### Running read-buildbot-config step. 01:32:10 INFO - ##### 01:32:10 INFO - Running pre-action listener: _resource_record_pre_action 01:32:10 INFO - Running main action method: read_buildbot_config 01:32:10 INFO - Using buildbot properties: 01:32:10 INFO - { 01:32:10 INFO - "properties": { 01:32:10 INFO - "buildnumber": 3344, 01:32:10 INFO - "product": "firefox", 01:32:10 INFO - "script_repo_revision": "production", 01:32:10 INFO - "builddir": "mozilla-inbound_yosemite_test-dromaeojs", 01:32:10 INFO - "repository": "", 01:32:10 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 mozilla-inbound talos dromaeojs", 01:32:10 INFO - "buildid": "20151110000603", 01:32:10 INFO - "slavename": "t-yosemite-r5-0093", 01:32:10 INFO - "pgo_build": "False", 01:32:10 INFO - "basedir": "/builds/slave/test", 01:32:10 INFO - "project": "", 01:32:10 INFO - "platform": "yosemite", 01:32:10 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 01:32:10 INFO - "slavebuilddir": "test", 01:32:10 INFO - "scheduler": "tests-mozilla-inbound-macosx64-talos", 01:32:10 INFO - "branch": "mozilla-inbound", 01:32:10 INFO - "repo_path": "integration/mozilla-inbound", 01:32:10 INFO - "stage_platform": "macosx64", 01:32:10 INFO - "builduid": "f90fd593a93f4a8884557765fe8002f4", 01:32:10 INFO - "revision": "180b1c201aa2ec9277207d76341c9b60254c80b4" 01:32:10 INFO - }, 01:32:10 INFO - "sourcestamp": { 01:32:10 INFO - "repository": "", 01:32:10 INFO - "hasPatch": false, 01:32:10 INFO - "project": "", 01:32:10 INFO - "branch": "mozilla-inbound-macosx64-talos", 01:32:10 INFO - "changes": [ 01:32:10 INFO - { 01:32:10 INFO - "category": null, 01:32:10 INFO - "files": [ 01:32:10 INFO - { 01:32:10 INFO - "url": null, 01:32:10 INFO - "name": "https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 01:32:10 INFO - } 01:32:10 INFO - ], 01:32:10 INFO - "repository": "", 01:32:10 INFO - "rev": "180b1c201aa2ec9277207d76341c9b60254c80b4", 01:32:10 INFO - "who": "j.parkouss@gmail.com", 01:32:10 INFO - "when": 1447147838, 01:32:10 INFO - "number": 6641647, 01:32:10 INFO - "comments": "Bug 1207074 - remove obsolete code to download talos json in harness. r=jmaher", 01:32:10 INFO - "project": "", 01:32:10 INFO - "at": "Tue 10 Nov 2015 01:30:38", 01:32:10 INFO - "branch": "mozilla-inbound-macosx64-talos", 01:32:10 INFO - "revlink": "", 01:32:10 INFO - "properties": [ 01:32:10 INFO - [ 01:32:10 INFO - "buildid", 01:32:10 INFO - "20151110000603", 01:32:10 INFO - "Change" 01:32:10 INFO - ], 01:32:10 INFO - [ 01:32:10 INFO - "builduid", 01:32:10 INFO - "f90fd593a93f4a8884557765fe8002f4", 01:32:10 INFO - "Change" 01:32:10 INFO - ], 01:32:10 INFO - [ 01:32:10 INFO - "pgo_build", 01:32:10 INFO - "False", 01:32:10 INFO - "Change" 01:32:10 INFO - ] 01:32:10 INFO - ], 01:32:10 INFO - "revision": "180b1c201aa2ec9277207d76341c9b60254c80b4" 01:32:10 INFO - } 01:32:10 INFO - ], 01:32:10 INFO - "revision": "180b1c201aa2ec9277207d76341c9b60254c80b4" 01:32:10 INFO - } 01:32:10 INFO - } 01:32:10 INFO - Found installer url https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 01:32:10 INFO - Running post-action listener: _resource_record_post_action 01:32:10 INFO - ##### 01:32:10 INFO - ##### Running download-and-extract step. 01:32:10 INFO - ##### 01:32:10 INFO - Running pre-action listener: _resource_record_pre_action 01:32:10 INFO - Running main action method: download_and_extract 01:32:10 INFO - mkdir: /builds/slave/test/build/tests 01:32:10 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')]} 01:32:10 INFO - https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 01:32:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/test_packages.json 01:32:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/test_packages.json 01:32:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 01:32:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 01:32:19 INFO - Downloaded 1149 bytes. 01:32:19 INFO - Reading from file /builds/slave/test/build/test_packages.json 01:32:19 INFO - Using the following test package requirements: 01:32:19 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 01:32:19 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 01:32:19 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 01:32:19 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 01:32:19 INFO - u'jsshell-mac.zip'], 01:32:19 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 01:32:19 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 01:32:19 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 01:32:19 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 01:32:19 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 01:32:19 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 01:32:19 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 01:32:19 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 01:32:19 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 01:32:19 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 01:32:19 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 01:32:19 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 01:32:19 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 01:32:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:32:19 INFO - https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 01:32:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 01:32:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 01:32:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/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 01:32:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/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 01:32:22 INFO - Downloaded 17436522 bytes. 01:32:22 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 01:32:22 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 01:32:22 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 01:32:27 INFO - Return code: 0 01:32:27 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 01:32:27 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')]} 01:32:27 INFO - https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 01:32:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 01:32:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 01:32:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/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 01:32:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/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 01:32:30 INFO - Downloaded 17436522 bytes. 01:32:30 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 01:32:30 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 01:32:30 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 01:32:36 INFO - Return code: 0 01:32:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:32:36 INFO - https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 01:32:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 01:32:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 01:32:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/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 01:32:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/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 01:32:37 INFO - Downloaded 11131618 bytes. 01:32:37 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 01:32:37 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 01:32:37 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 01:32:37 INFO - Return code: 0 01:32:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:32:37 INFO - https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 01:32:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 01:32:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 01:32:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 01:32:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YmeIiQZRQP6V3LgjS9YlPg/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 01:32:40 INFO - Downloaded 108637557 bytes. 01:32:40 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 01:32:40 INFO - mkdir: /builds/slave/test/properties 01:32:40 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 01:32:40 INFO - Writing to file /builds/slave/test/properties/build_url 01:32:40 INFO - Contents: 01:32:40 INFO - build_url:https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 01:32:40 INFO - Running post-action listener: _resource_record_post_action 01:32:40 INFO - Running post-action listener: set_extra_try_arguments 01:32:40 INFO - ##### 01:32:40 INFO - ##### Running populate-webroot step. 01:32:40 INFO - ##### 01:32:40 INFO - Running pre-action listener: _resource_record_pre_action 01:32:40 INFO - Running main action method: populate_webroot 01:32:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 01:32:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 01:32:40 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 01:32:40 INFO - '../fennec_ids.txt'], 01:32:40 INFO - 'tests': ['tcheck2']}, 01:32:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 01:32:40 INFO - '--tppagecycles', 01:32:40 INFO - '7'], 01:32:40 INFO - 'tests': ['tsvgm']}}, 01:32:40 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 01:32:40 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 01:32:40 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 01:32:40 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 01:32:40 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:32:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:32:40 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:32:40 INFO - 'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:32:40 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:32:40 INFO - 'tests': ['damp', 'tps']}, 01:32:40 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:32:40 INFO - 'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['damp', 'tps']}, 01:32:40 INFO - 'g3': {'tests': ['dromaeo_dom']}, 01:32:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 01:32:40 INFO - 'other': {'tests': ['a11yr', 01:32:40 INFO - 'ts_paint', 01:32:40 INFO - 'tpaint', 01:32:40 INFO - 'sessionrestore', 01:32:40 INFO - 'sessionrestore_no_auto_restore']}, 01:32:40 INFO - 'other-e10s': {'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['a11yr', 01:32:40 INFO - 'ts_paint', 01:32:40 INFO - 'tpaint', 01:32:40 INFO - 'sessionrestore', 01:32:40 INFO - 'sessionrestore_no_auto_restore']}, 01:32:40 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['a11yr', 01:32:40 INFO - 'ts_paint', 01:32:40 INFO - 'tpaint', 01:32:40 INFO - 'sessionrestore', 01:32:40 INFO - 'sessionrestore_no_auto_restore']}, 01:32:40 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['a11yr', 01:32:40 INFO - 'ts_paint', 01:32:40 INFO - 'tpaint', 01:32:40 INFO - 'sessionrestore', 01:32:40 INFO - 'sessionrestore_no_auto_restore']}, 01:32:40 INFO - 'other_l64': {'tests': ['a11yr', 01:32:40 INFO - 'ts_paint', 01:32:40 INFO - 'tpaint', 01:32:40 INFO - 'sessionrestore', 01:32:40 INFO - 'sessionrestore_no_auto_restore']}, 01:32:40 INFO - 'other_nol64': {'tests': ['a11yr', 01:32:40 INFO - 'ts_paint', 01:32:40 INFO - 'tpaint', 01:32:40 INFO - 'sessionrestore', 01:32:40 INFO - 'sessionrestore_no_auto_restore']}, 01:32:40 INFO - 'svgr': {'tests': ['tsvgx', 01:32:40 INFO - 'tsvgr_opacity', 01:32:40 INFO - 'tart', 01:32:40 INFO - 'tscrollx', 01:32:40 INFO - 'cart']}, 01:32:40 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['tsvgx', 01:32:40 INFO - 'tsvgr_opacity', 01:32:40 INFO - 'tart', 01:32:40 INFO - 'tscrollx', 01:32:40 INFO - 'cart']}, 01:32:40 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:32:40 INFO - 'tests': ['tp5o']}, 01:32:40 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:32:40 INFO - 'talos_options': ['--e10s'], 01:32:40 INFO - 'tests': ['tp5o']}, 01:32:40 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:32:40 INFO - 'talos_options': ['--xperf_path', 01:32:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:32:40 INFO - 'tests': ['tp5n']}, 01:32:40 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:32:40 INFO - 'talos_options': ['--e10s', 01:32:40 INFO - '--xperf_path', 01:32:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:32:40 INFO - 'tests': ['tp5n']}}, 01:32:40 INFO - 'talos.zip': {'path': '', 01:32:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 01:32:40 INFO - Running post-action listener: _resource_record_post_action 01:32:40 INFO - ##### 01:32:40 INFO - ##### Running create-virtualenv step. 01:32:40 INFO - ##### 01:32:40 INFO - Running pre-action listener: _resource_record_pre_action 01:32:40 INFO - Running main action method: create_virtualenv 01:32:40 INFO - Creating virtualenv /builds/slave/test/build/venv 01:32:40 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 01:32:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 01:32:41 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 01:32:41 INFO - Using real prefix '/tools/python27' 01:32:41 INFO - New python executable in /builds/slave/test/build/venv/bin/python 01:32:41 INFO - Installing distribute.............................................................................................................................................................................................done. 01:32:45 INFO - Installing pip.................done. 01:32:45 INFO - Return code: 0 01:32:45 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 01:32:45 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')]} 01:32:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:32:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32:45 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')]} 01:32:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:32:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32:45 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 0x10aab1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa8e228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fde00d8e570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9d49f0>, '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 0x10a734db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a9c88c8>, '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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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 01:32:45 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 01:32:45 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 01:32:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.3xhO3nTEEq/Render', 01:32:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 01:32:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 01:32:45 INFO - 'HOME': '/Users/cltbld', 01:32:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 01:32:45 INFO - 'LOGNAME': 'cltbld', 01:32:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:32:45 INFO - 'MOZ_NO_REMOTE': '1', 01:32:45 INFO - 'NO_EM_RESTART': '1', 01:32:45 INFO - 'PAGER': '/bin/cat', 01:32:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 01:32:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:32:45 INFO - 'PWD': '/builds/slave/test', 01:32:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 01:32:45 INFO - 'SHELL': '/bin/bash', 01:32:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Iqai9CkTJV/Listeners', 01:32:45 INFO - 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/', 01:32:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 01:32:45 INFO - 'USER': 'cltbld', 01:32:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 01:32:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 01:32:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:32:45 INFO - 'XPC_FLAGS': '0x0', 01:32:45 INFO - 'XPC_SERVICE_NAME': '0', 01:32:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 01:32:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:32:46 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 01:32:46 INFO - Cleaning up... 01:32:46 INFO - Return code: 0 01:32:46 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 01:32: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')]} 01:32:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:32:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32: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')]} 01:32:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:32:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32: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', '--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 0x10aab1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa8e228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fde00d8e570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9d49f0>, '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 0x10a734db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a9c88c8>, '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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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 01:32:46 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 01:32:46 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 01:32:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.3xhO3nTEEq/Render', 01:32:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 01:32:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 01:32:46 INFO - 'HOME': '/Users/cltbld', 01:32:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 01:32:46 INFO - 'LOGNAME': 'cltbld', 01:32:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:32:46 INFO - 'MOZ_NO_REMOTE': '1', 01:32:46 INFO - 'NO_EM_RESTART': '1', 01:32:46 INFO - 'PAGER': '/bin/cat', 01:32:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 01:32:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:32:46 INFO - 'PWD': '/builds/slave/test', 01:32:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 01:32:46 INFO - 'SHELL': '/bin/bash', 01:32:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Iqai9CkTJV/Listeners', 01:32:46 INFO - 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/', 01:32:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 01:32:46 INFO - 'USER': 'cltbld', 01:32:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 01:32:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 01:32:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:32:46 INFO - 'XPC_FLAGS': '0x0', 01:32:46 INFO - 'XPC_SERVICE_NAME': '0', 01:32:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 01:32:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:32:46 INFO - Downloading/unpacking psutil>=0.7.1 01:32:46 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 01:32:46 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 01:32:46 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 01:32:46 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 01:32:46 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 01:32:46 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 01:32:49 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 01:32:49 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 01:32:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 01:32:49 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:32:49 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:32:49 INFO - Installing collected packages: psutil 01:32:49 INFO - Running setup.py install for psutil 01:32:49 INFO - building 'psutil._psutil_osx' extension 01:32:49 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 01:32:49 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 01:32:49 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 01:32:50 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 01:32:50 INFO - building 'psutil._psutil_posix' extension 01:32:50 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 01:32:50 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 01:32:50 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 01:32:50 INFO - ^ 01:32:50 INFO - 1 warning generated. 01:32:50 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 01:32:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:32:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:32:50 INFO - Successfully installed psutil 01:32:50 INFO - Cleaning up... 01:32:50 INFO - Return code: 0 01:32:50 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 01:32:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:32:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:32:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:32:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:32:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10aab1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa8e228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fde00d8e570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9d49f0>, '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 0x10a734db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a9c88c8>, '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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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 01:32:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 01:32:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 01:32:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.3xhO3nTEEq/Render', 01:32:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 01:32:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 01:32:50 INFO - 'HOME': '/Users/cltbld', 01:32:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 01:32:50 INFO - 'LOGNAME': 'cltbld', 01:32:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:32:50 INFO - 'MOZ_NO_REMOTE': '1', 01:32:50 INFO - 'NO_EM_RESTART': '1', 01:32:50 INFO - 'PAGER': '/bin/cat', 01:32:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 01:32:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:32:50 INFO - 'PWD': '/builds/slave/test', 01:32:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 01:32:50 INFO - 'SHELL': '/bin/bash', 01:32:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Iqai9CkTJV/Listeners', 01:32:50 INFO - 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/', 01:32:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 01:32:50 INFO - 'USER': 'cltbld', 01:32:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 01:32:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 01:32:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:32:50 INFO - 'XPC_FLAGS': '0x0', 01:32:50 INFO - 'XPC_SERVICE_NAME': '0', 01:32:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 01:32:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:32:50 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 01:32:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:32:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:32:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:32:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:32:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:32:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:32:53 INFO - Downloading mozsystemmonitor-0.0.tar.gz 01:32:53 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 01:32:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 01:32:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 01:32:53 INFO - Installing collected packages: mozsystemmonitor 01:32:53 INFO - Running setup.py install for mozsystemmonitor 01:32:53 INFO - Successfully installed mozsystemmonitor 01:32:53 INFO - Cleaning up... 01:32:53 INFO - Return code: 0 01:32:53 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 01:32:53 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')]} 01:32:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:32:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32:53 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')]} 01:32:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:32:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32:53 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 0x10aab1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa8e228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fde00d8e570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9d49f0>, '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 0x10a734db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a9c88c8>, '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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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 01:32:53 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 01:32:53 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 01:32:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.3xhO3nTEEq/Render', 01:32:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 01:32:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 01:32:53 INFO - 'HOME': '/Users/cltbld', 01:32:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 01:32:53 INFO - 'LOGNAME': 'cltbld', 01:32:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:32:53 INFO - 'MOZ_NO_REMOTE': '1', 01:32:53 INFO - 'NO_EM_RESTART': '1', 01:32:53 INFO - 'PAGER': '/bin/cat', 01:32:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 01:32:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:32:53 INFO - 'PWD': '/builds/slave/test', 01:32:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 01:32:53 INFO - 'SHELL': '/bin/bash', 01:32:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Iqai9CkTJV/Listeners', 01:32:53 INFO - 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/', 01:32:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 01:32:53 INFO - 'USER': 'cltbld', 01:32:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 01:32:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 01:32:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:32:53 INFO - 'XPC_FLAGS': '0x0', 01:32:53 INFO - 'XPC_SERVICE_NAME': '0', 01:32:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 01:32:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:32:53 INFO - Downloading/unpacking blobuploader==1.2.4 01:32:53 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 01:32:53 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 01:32:53 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 01:32:53 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 01:32:53 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 01:32:53 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 01:32:56 INFO - Downloading blobuploader-1.2.4.tar.gz 01:32:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 01:32:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 01:32:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 01:32:56 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 01:32:56 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 01:32:56 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 01:32:56 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 01:32:56 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 01:32:56 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 01:32:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 01:32:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 01:32:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 01:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:32:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:32:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:32:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:32:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:32:57 INFO - Downloading docopt-0.6.1.tar.gz 01:32:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 01:32:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 01:32:57 INFO - Installing collected packages: blobuploader, requests, docopt 01:32:57 INFO - Running setup.py install for blobuploader 01:32:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 01:32:58 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 01:32:58 INFO - Running setup.py install for requests 01:32:58 INFO - Running setup.py install for docopt 01:32:58 INFO - Successfully installed blobuploader requests docopt 01:32:58 INFO - Cleaning up... 01:32:58 INFO - Return code: 0 01:32:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:32: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')]} 01:32:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:32:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32: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')]} 01:32:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:32:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:32:58 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 0x10aab1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa8e228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fde00d8e570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9d49f0>, '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 0x10a734db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a9c88c8>, '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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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 01:32:58 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 01:32:58 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 01:32:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.3xhO3nTEEq/Render', 01:32:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 01:32:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 01:32:58 INFO - 'HOME': '/Users/cltbld', 01:32:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 01:32:58 INFO - 'LOGNAME': 'cltbld', 01:32:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:32:58 INFO - 'MOZ_NO_REMOTE': '1', 01:32:58 INFO - 'NO_EM_RESTART': '1', 01:32:58 INFO - 'PAGER': '/bin/cat', 01:32:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 01:32:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:32:58 INFO - 'PWD': '/builds/slave/test', 01:32:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 01:32:58 INFO - 'SHELL': '/bin/bash', 01:32:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Iqai9CkTJV/Listeners', 01:32:58 INFO - 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/', 01:32:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 01:32:58 INFO - 'USER': 'cltbld', 01:32:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 01:32:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 01:32:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:32:58 INFO - 'XPC_FLAGS': '0x0', 01:32:58 INFO - 'XPC_SERVICE_NAME': '0', 01:32:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 01:32:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:32:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 01:32:59 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-jazHBU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 01:32:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 01:32:59 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-aa5Jef-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 01:32:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 01:32:59 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-ISgE0J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 01:32:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 01:32:59 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-LVjV8X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 01:32:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 01:32:59 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-HjhsgL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 01:32:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 01:32:59 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-AAHzQb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 01:32:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 01:32:59 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-MEHMl2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 01:33:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 01:33:00 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-2H0c1U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 01:33:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 01:33:00 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-BXxBjk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 01:33:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 01:33:00 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-KXS287-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 01:33:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 01:33:00 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-5do6pC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 01:33:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 01:33:00 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-XrRiBU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 01:33:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 01:33:00 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-u1C8JW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 01:33:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 01:33:00 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-_wb7r_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 01:33:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 01:33:01 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-PF9nc8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 01:33:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 01:33:01 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-THKugd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 01:33:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 01:33:01 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-8quRBl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 01:33:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 01:33:01 INFO - Running setup.py install for manifestparser 01:33:01 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 01:33:01 INFO - Running setup.py install for mozcrash 01:33:01 INFO - Running setup.py install for mozdebug 01:33:01 INFO - Running setup.py install for mozdevice 01:33:02 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 01:33:02 INFO - Installing dm script to /builds/slave/test/build/venv/bin 01:33:02 INFO - Running setup.py install for mozfile 01:33:02 INFO - Running setup.py install for mozhttpd 01:33:02 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 01:33:02 INFO - Running setup.py install for mozinfo 01:33:02 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 01:33:02 INFO - Running setup.py install for mozInstall 01:33:02 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 01:33:02 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 01:33:02 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 01:33:02 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 01:33:02 INFO - Running setup.py install for mozleak 01:33:02 INFO - Running setup.py install for mozlog 01:33:03 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 01:33:03 INFO - Running setup.py install for moznetwork 01:33:03 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 01:33:03 INFO - Running setup.py install for mozprocess 01:33:03 INFO - Running setup.py install for mozprofile 01:33:03 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 01:33:03 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 01:33:03 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 01:33:03 INFO - Running setup.py install for mozrunner 01:33:03 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 01:33:03 INFO - Running setup.py install for mozscreenshot 01:33:04 INFO - Running setup.py install for moztest 01:33:04 INFO - Running setup.py install for mozversion 01:33:04 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 01:33:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 01:33:04 INFO - Cleaning up... 01:33:04 INFO - Return code: 0 01:33:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:33:04 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')]} 01:33:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:33:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:33:04 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')]} 01:33:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:33:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:33:04 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 0x10aab1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa8e228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fde00d8e570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9d49f0>, '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 0x10a734db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a9c88c8>, '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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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 01:33:04 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 01:33:04 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 01:33:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.3xhO3nTEEq/Render', 01:33:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 01:33:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 01:33:04 INFO - 'HOME': '/Users/cltbld', 01:33:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 01:33:04 INFO - 'LOGNAME': 'cltbld', 01:33:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:33:04 INFO - 'MOZ_NO_REMOTE': '1', 01:33:04 INFO - 'NO_EM_RESTART': '1', 01:33:04 INFO - 'PAGER': '/bin/cat', 01:33:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 01:33:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:33:04 INFO - 'PWD': '/builds/slave/test', 01:33:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 01:33:04 INFO - 'SHELL': '/bin/bash', 01:33:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Iqai9CkTJV/Listeners', 01:33:04 INFO - 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/', 01:33:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 01:33:04 INFO - 'USER': 'cltbld', 01:33:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 01:33:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 01:33:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:33:04 INFO - 'XPC_FLAGS': '0x0', 01:33:04 INFO - 'XPC_SERVICE_NAME': '0', 01:33:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 01:33:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:33:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 01:33:05 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-R3Ois7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 01:33:05 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)) 01:33:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 01:33:05 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-GuMwVK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 01:33:05 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)) 01:33:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 01:33:05 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-qorA_X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 01:33:05 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)) 01:33:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 01:33:05 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-vA2WYd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 01:33:05 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)) 01:33:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 01:33:05 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-upAB6y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 01:33:05 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)) 01:33:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 01:33:05 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-1WqNyC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 01:33:05 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)) 01:33:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 01:33:05 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-OwV5kk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 01:33:05 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)) 01:33:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 01:33:05 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-71bOa1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 01:33:06 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)) 01:33:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 01:33:06 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-iERzGV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 01:33:06 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)) 01:33:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 01:33:06 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-kIuX7s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 01:33:06 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)) 01:33:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 01:33:06 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-MohXW0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 01:33:06 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)) 01:33:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 01:33:06 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-UnAdMl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 01:33:06 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)) 01:33:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 01:33:06 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-_OWkMA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 01:33:06 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)) 01:33:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 01:33:06 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-ID8eXA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 01:33:06 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)) 01:33:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 01:33:06 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-YiQwN5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 01:33:07 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)) 01:33:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 01:33:07 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-yPf0fb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 01:33:07 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)) 01:33:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 01:33:07 INFO - Running setup.py (path:/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/pip-RsCixd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 01:33:07 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)) 01:33:07 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)) 01:33:07 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)) 01:33:07 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)) 01:33:07 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)) 01:33:07 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)) 01:33:07 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 01:33:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:33:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:33:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:33:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:33:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:33:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:33:09 INFO - Downloading blessings-1.5.1.tar.gz 01:33:09 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 01:33:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 01:33:09 INFO - Installing collected packages: blessings 01:33:09 INFO - Running setup.py install for blessings 01:33:10 INFO - Successfully installed blessings 01:33:10 INFO - Cleaning up... 01:33:10 INFO - Return code: 0 01:33:10 INFO - Done creating virtualenv /builds/slave/test/build/venv. 01:33:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 01:33:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 01:33:10 INFO - Reading from file tmpfile_stdout 01:33:10 INFO - Current package versions: 01:33:10 INFO - blessings == 1.5.1 01:33:10 INFO - blobuploader == 1.2.4 01:33:10 INFO - docopt == 0.6.1 01:33:10 INFO - manifestparser == 1.1 01:33:10 INFO - mozInstall == 1.12 01:33:10 INFO - mozcrash == 0.16 01:33:10 INFO - mozdebug == 0.1 01:33:10 INFO - mozdevice == 0.47 01:33:10 INFO - mozfile == 1.2 01:33:10 INFO - mozhttpd == 0.7 01:33:10 INFO - mozinfo == 0.9 01:33:10 INFO - mozleak == 0.1 01:33:10 INFO - mozlog == 3.0 01:33:10 INFO - moznetwork == 0.27 01:33:10 INFO - mozprocess == 0.22 01:33:10 INFO - mozprofile == 0.27 01:33:10 INFO - mozrunner == 6.11 01:33:10 INFO - mozscreenshot == 0.1 01:33:10 INFO - mozsystemmonitor == 0.0 01:33:10 INFO - moztest == 0.7 01:33:10 INFO - mozversion == 1.4 01:33:10 INFO - psutil == 3.1.1 01:33:10 INFO - requests == 1.2.3 01:33:10 INFO - wsgiref == 0.1.2 01:33:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:33:10 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')]} 01:33:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:33:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:33:10 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')]} 01:33:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:33:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:33:10 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 0x10aab1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa8e228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fde00d8e570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9d49f0>, '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 0x10a734db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a9c88c8>, '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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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 01:33:10 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 01:33:10 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 01:33:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.3xhO3nTEEq/Render', 01:33:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 01:33:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 01:33:10 INFO - 'HOME': '/Users/cltbld', 01:33:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 01:33:10 INFO - 'LOGNAME': 'cltbld', 01:33:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:33:10 INFO - 'MOZ_NO_REMOTE': '1', 01:33:10 INFO - 'NO_EM_RESTART': '1', 01:33:10 INFO - 'PAGER': '/bin/cat', 01:33:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 01:33:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:33:10 INFO - 'PWD': '/builds/slave/test', 01:33:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 01:33:10 INFO - 'SHELL': '/bin/bash', 01:33:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Iqai9CkTJV/Listeners', 01:33:10 INFO - 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/', 01:33:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 01:33:10 INFO - 'USER': 'cltbld', 01:33:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 01:33:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 01:33:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:33:10 INFO - 'XPC_FLAGS': '0x0', 01:33:10 INFO - 'XPC_SERVICE_NAME': '0', 01:33:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 01:33:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:33:10 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)) 01:33:10 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)) 01:33:10 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)) 01:33:10 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)) 01:33:10 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)) 01:33:10 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)) 01:33:10 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)) 01:33:10 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)) 01:33:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 01:33:10 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 01:33:10 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)) 01:33:10 INFO - Cleaning up... 01:33:10 INFO - Return code: 0 01:33:10 INFO - Running post-action listener: _resource_record_post_action 01:33:10 INFO - Running post-action listener: _start_resource_monitoring 01:33:10 INFO - Starting resource monitoring. 01:33:10 INFO - ##### 01:33:10 INFO - ##### Running install step. 01:33:10 INFO - ##### 01:33:10 INFO - Running pre-action listener: _resource_record_pre_action 01:33:10 INFO - Running main action method: install 01:33:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 01:33:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 01:33:11 INFO - Reading from file tmpfile_stdout 01:33:11 INFO - Detecting whether we're running mozinstall >=1.0... 01:33:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 01:33:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 01:33:11 INFO - Reading from file tmpfile_stdout 01:33:11 INFO - Output received: 01:33:11 INFO - Usage: mozinstall [options] installer 01:33:11 INFO - Options: 01:33:11 INFO - -h, --help show this help message and exit 01:33:11 INFO - -d DEST, --destination=DEST 01:33:11 INFO - Directory to install application into. [default: 01:33:11 INFO - "/builds/slave/test"] 01:33:11 INFO - --app=APP Application being installed. [default: firefox] 01:33:11 INFO - mkdir: /builds/slave/test/build/application 01:33:11 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'] 01:33:11 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 01:33:50 INFO - Reading from file tmpfile_stdout 01:33:50 INFO - Output received: 01:33:50 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 01:33:50 INFO - Running post-action listener: _resource_record_post_action 01:33:50 INFO - ##### 01:33:50 INFO - ##### Running run-tests step. 01:33:50 INFO - ##### 01:33:50 INFO - Running pre-action listener: _resource_record_pre_action 01:33:50 INFO - Running main action method: run_tests 01:33:50 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 01:33:50 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 01:33:50 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 01:33:50 INFO - 2015-11-10 01:33:50.814 screenresolution[2261:11356] starting screenresolution argv=screenresolution get 01:33:50 INFO - 2015-11-10 01:33:50.817 screenresolution[2261:11356] Display 0: 1600x1200x32@60 01:33:50 INFO - 2015-11-10 01:33:50.824 screenresolution[2262:11358] starting screenresolution argv=screenresolution list 01:33:50 INFO - Available Modes on Display 0 01:33:50 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 01:33:50 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 01:33:50 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 01:33:50 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 01:33:51 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 01:33:51 INFO - Intel HD Graphics 3000: 01:33:51 INFO - Chipset Model: Intel HD Graphics 3000 01:33:51 INFO - Type: GPU 01:33:51 INFO - Bus: Built-In 01:33:51 INFO - VRAM (Total): 512 MB 01:33:51 INFO - VRAM (Dynamic, Max): 10 01:33:51 INFO - Vendor: Intel (0x8086) 01:33:51 INFO - Device ID: 0x0116 01:33:51 INFO - Revision ID: 0x0009 01:33:51 INFO - Displays: 01:33:51 INFO - Display: 01:33:51 INFO - Resolution: 1600 x 1200 @ 60 Hz 01:33:51 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 01:33:51 INFO - Display Serial Number: 1600x1200 60 01:33:51 INFO - Main Display: Yes 01:33:51 INFO - Mirror: Off 01:33:51 INFO - Online: Yes 01:33:51 INFO - Rotation: Supported 01:33:51 INFO - Return code: 0 01:33:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 01:33:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 01:33:51 INFO - Python 2.7.3 01:33:51 INFO - Return code: 0 01:33:51 INFO - grabbing minidump binary from tooltool 01:33:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:33:51 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9d49f0>, '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 0x10a734db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a9c88c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 01:33:51 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 01:33:51 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 01:33:51 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 01:33:51 INFO - Return code: 0 01:33:51 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 01:33:51 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 01:33:51 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 01:33:51 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 01:33:51 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 01:33:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0093', '--webServer', 'localhost'] in /builds/slave/test/build 01:33:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0093 --webServer localhost 01:33:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.3xhO3nTEEq/Render', 01:33:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 01:33:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 01:33:51 INFO - 'HOME': '/Users/cltbld', 01:33:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 01:33:51 INFO - 'LOGNAME': 'cltbld', 01:33:51 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 01:33:51 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 01:33:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:33:51 INFO - 'MOZ_NO_REMOTE': '1', 01:33:51 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 01:33:51 INFO - 'NO_EM_RESTART': '1', 01:33:51 INFO - 'PAGER': '/bin/cat', 01:33:51 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 01:33:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:33:51 INFO - 'PWD': '/builds/slave/test', 01:33:51 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 01:33:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 01:33:51 INFO - 'SHELL': '/bin/bash', 01:33:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Iqai9CkTJV/Listeners', 01:33:51 INFO - 'TMPDIR': '/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/', 01:33:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 01:33:51 INFO - 'USER': 'cltbld', 01:33:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 01:33:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 01:33:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:33:51 INFO - 'XPC_FLAGS': '0x0', 01:33:51 INFO - 'XPC_SERVICE_NAME': '0', 01:33:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 01:33:51 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0093', '--webServer', 'localhost'] with output_timeout 3600 01:33:51 INFO - mozversion INFO | application_buildid: 20151110000603 01:33:51 INFO - mozversion INFO | application_changeset: 180b1c201aa2ec9277207d76341c9b60254c80b4 01:33:51 INFO - mozversion INFO | application_display_name: Nightly 01:33:51 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 01:33:51 INFO - mozversion INFO | application_name: Firefox 01:33:51 INFO - mozversion INFO | application_remotingname: firefox 01:33:51 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/mozilla-inbound 01:33:51 INFO - mozversion INFO | application_vendor: Mozilla 01:33:51 INFO - mozversion INFO | application_version: 45.0a1 01:33:51 INFO - mozversion INFO | platform_buildid: 20151110000603 01:33:51 INFO - mozversion INFO | platform_changeset: 180b1c201aa2ec9277207d76341c9b60254c80b4 01:33:51 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 01:33:51 INFO - mozversion INFO | platform_version: 45.0a1 01:33:51 INFO - 2015-11-10 01:33:51,503 DEBUG : using testdate: 1447148031 01:33:51 INFO - 2015-11-10 01:33:51,503 DEBUG : actual date: 1447148031 01:33:51 INFO - 2015-11-10 01:33:51,513 INFO : starting webserver on 'localhost:49508' 01:33:51 INFO - 2015-11-10 01:33:51,514 INFO : Starting test suite t-yosemite-r5-0093 01:33:51 INFO - 2015-11-10 01:33:51,515 INFO : Starting test dromaeo_css 01:33:51 INFO - 2015-11-10 01:33:51,515 DEBUG : operating with platform_type : mac_ 01:33:51 INFO - 2015-11-10 01:33:51,517 INFO : Initialising browser for dromaeo_css test... 01:33:51 INFO - 2015-11-10 01:33:51,550 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/tmppTg8K6/profile http://localhost:49508/getInfo.html 01:33:54 INFO - 2015-11-10 01:33:54,294 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:33:54 INFO - 2015-11-10 01:33:54,294 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:33:54 INFO - 2015-11-10 01:33:54,294 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 01:33:54 INFO - 2015-11-10 01:33:54,295 DEBUG : BROWSER_OUTPUT: __metrics 01:33:54 INFO - 2015-11-10 01:33:54,311 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:33:55 INFO - 2015-11-10 01:33:55,061 INFO : Browser initialized. 01:33:55 INFO - 2015-11-10 01:33:55,062 INFO : Running cycle 1/1 for dromaeo_css test... 01:33:55 INFO - 2015-11-10 01:33:55,062 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/tmppTg8K6/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:34:07 INFO - 2015-11-10 01:34:07,295 DEBUG : BROWSER_OUTPUT: RSS: Main: 228810752 01:34:07 INFO - 2015-11-10 01:34:07,296 DEBUG : BROWSER_OUTPUT: 01:34:59 INFO - 2015-11-10 01:34:59,098 DEBUG : BROWSER_OUTPUT: 1447148099097 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] 01:37:09 INFO - 2015-11-10 01:37:09,195 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49508/tests/dromaeo/cssquery-ext.html) 01:37:10 INFO - 2015-11-10 01:37:10,434 DEBUG : BROWSER_OUTPUT: RSS: Main: 331886592 01:37:10 INFO - 2015-11-10 01:37:10,434 DEBUG : BROWSER_OUTPUT: 01:40:13 INFO - 2015-11-10 01:40:13,089 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/dromaeo/cssquery-ext.html (next: http://localhost:49508/tests/dromaeo/cssquery-jquery.html) 01:40:13 INFO - 2015-11-10 01:40:13,675 DEBUG : BROWSER_OUTPUT: RSS: Main: 360693760 01:40:13 INFO - 2015-11-10 01:40:13,675 DEBUG : BROWSER_OUTPUT: 01:43:16 INFO - 2015-11-10 01:43:16,014 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49508/tests/dromaeo/cssquery-mootools.html) 01:43:16 INFO - 2015-11-10 01:43:16,599 DEBUG : BROWSER_OUTPUT: RSS: Main: 324063232 01:43:16 INFO - 2015-11-10 01:43:16,599 DEBUG : BROWSER_OUTPUT: 01:46:18 INFO - 2015-11-10 01:46:18,725 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49508/tests/dromaeo/cssquery-prototype.html) 01:46:19 INFO - 2015-11-10 01:46:19,312 DEBUG : BROWSER_OUTPUT: RSS: Main: 318607360 01:46:19 INFO - 2015-11-10 01:46:19,312 DEBUG : BROWSER_OUTPUT: 01:49:22 INFO - 2015-11-10 01:49:22,563 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49508/tests/dromaeo/cssquery-yui.html) 01:49:23 INFO - 2015-11-10 01:49:23,193 DEBUG : BROWSER_OUTPUT: RSS: Main: 319873024 01:49:23 INFO - 2015-11-10 01:49:23,193 DEBUG : BROWSER_OUTPUT: 01:52:25 INFO - 2015-11-10 01:52:25,828 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/dromaeo/cssquery-yui.html (next: http://localhost:49508/tests/dromaeo/cssquery-dojo.html) 01:52:26 INFO - 2015-11-10 01:52:26,092 DEBUG : BROWSER_OUTPUT: RSS: Main: 364089344 01:52:26 INFO - 2015-11-10 01:52:26,092 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,092 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:52:26 INFO - 2015-11-10 01:52:26,092 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:52:26 INFO - 2015-11-10 01:52:26,093 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:52:26 INFO - 2015-11-10 01:52:26,093 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:52:26 INFO - 2015-11-10 01:52:26,093 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2782.9165125046247;2833.617461642679;2855.2719056640553;2882.942341153177;2898.4782739106954;4668.393108895847;4695.2252878275085;4748.786304616292;4816.277558366247;4915.852524424264;4714.339992401066;4797.280407938802;4825.396825396817;4834.9274760878525;4836.516348365161;4526.411566496367;4541.977290113545;4588.49526552079;4622.422197225347;4672.836450724225;4634.884127896796;4645.860624181263;4656.092062047902;4676.158291507527;4722.858314250578;4446.177457170434;4448.6885917985755;4478.149151661174;4524.389207456984;4595.1728688836165;4538.704984176051;4554.066416384666;4567.177907976563;4599.747013914233;4610.4697959734385;4504.864854054384;4528.139653465831;4546.704464209815;4571.72569645819;4590.839320623795;4633.189191891405;4677.438707355105;4754.144254034272;4763.785629646674;4800.231962885921;5083.872903177413;5100.540951314362;5137.17805151174;5152.252923326097;5153.2270159476;5208.843734687927;5211.869703257411;5218.165093585008;5262.736863156827;5270.894582108336;4753.04939012199;4755.595774359183;4864.902701945976;4870.488598697157;4879.341288926021;5309.070912590281;5345.1982202669915;5349.277847490617;5370.436104209002;5455.263539422207;5085.74571271435;5090.796368145233;5091.338126043591;5108.412532558803;5111.948880511221;4916.139675556763;5030.195168772979;5196.324477817935;5205.115130427836;5292.153255479105;5138.3577052868395;5147.382314122255;5152.381714194321;5169.870753231124;5179.61152913533;5142.382914050263;5158.587313014949;5168.224766285088;5176.301199338116;5210.505002024802;3941;4017.2969730297664;4020.2160578686876;4027.134166154291;4057.2899742544937;3570.250247448065;3614.2229420674157;3646.9452958205648;3684.1526448916898;3686;4890.608751299887;4910.993246384554;4927.433345165352;4932.506749325111;4958.578520825698;5013.222950442687;5226.425093239741;5233.371995360581;5253.028189784902;5287.920681189786;4712.034033023222;4739.7630118493935;4761.595264402565;4852.272159176152;4886.511348865085;4570.497245303014;4573.268277075652;4620.2607582786595;4643.141018911512;4646.977664913714;5087.618428617942;5355.384130825005;5407.351117865803;5408.864778380572;5417.6478528895495;5105.2086926526445;5132.897342053213;5169.870753231199;5207.088759467002;5220.451852555427;5355.30381050461;5397.190421436816;5397.190421436816;5412.052890744183;5416.539594134385;4981.6014718823135;5134.075866344094;5191.532762051434;5217.660852044605;5243.68537887728;5143.151380022404;5144.485551444825;5213.08770965072;5229.895402092013;5272.235525848807;5094.949050509447;5096.923546146885;5110.821121260738;5119.667221630582;5152.433232344514;4888.486708895657;4904.656674032926;5085.084684756779;5097.872553186052;5099.974500127476;4852.320675105418;4938.456769755396;4945.184044632595;4972.378452693413;4980.750962451935;5030.2957585937265;5044.041632089891;5080.441151473409;5103.591712662904;5136.1268584340005;4816.036792641416;4958.504149585013;5010.323606313101;5023.196288593807;5054.69671819692 01:52:26 INFO - 2015-11-10 01:52:26,097 DEBUG : BROWSER_OUTPUT: |1;ext.html;497.6789970469048;503.91937290033604;507.66240450100685;510.98059371553757;525.5952916254487;27207.727922720765;28197.718022819765;34782.8260858696;35374;35398.2920341593;36785.448218276746;37357;37394.626053739456;37401.43897841528;37569;7201.3158749918675;7870.606469676508;7939.245771651713;8057.879131812998;8062.234087761653;7334.853302933938;9349.67276145335;9664.178544823699;9665.081817227352;9772.218222542215;9428.057194280585;9545.618175273015;9553.426794392359;9556.044395560422;9703.22374210065;7426.925730742678;7568.545887246728;9417.246620270362;9546.188573971222;9848.2613803965;9449;9546.665866694633;9575.664851730226;9585.137337639646;9611.663591774255;34586.65413345885;34613;35043.12392190216;35057.649423505696;35064;2627.3037645024083;2730.1127133681634;2809.6909339972585;2950.395168990352;2979.9421205471963;23660.76339236603;23717.288481345586;24210.63684044741;24288.149914753074;25051.24846254615;2043.4176259765895;2066.8346532277383;2076.045019291128;2088.0603728322317;2151.698762173297;240519;241322;243892.56107439054;243916;245036;51434.48565514372;51762;51817.48182518127;51931.48068519342;51969.740151299;47723;48648.27027594589;59006.70496647575;59601.40398596045;60213.69893150506;13022.47910083605;13217.73564528704;13359.198448093146;13368.197908125543;13376.197428154343;9574;9605.279604029725;9651.565679544437;9724;9732.41605503672;16787.664246714998;17033.659326813395;17079.82920170807;17085.829141708673;17131.914340428466;6973.267806880306;7098.077249957576;7110.715571377191;7137.857242855114;7168.92831071693;762.771168649403;828.842519921213;846.7459762071354;941.6562954521551;963.8963386921935;23839.642405363935;24234.394140146636;24320.878395608263;24427.09166533346;24729.752702473106;918.8989211186898;935.219092058139;960.9855852162223;997.7206382212992;1021.7854250607455;12691.49234030647;12858.871411285767;12885.420156092998;13139.64938940564;13738.10702304367;217853;219751;222097;222335;222653;43469.13061738748;43728.12543749107;43735;44292.778536107115;44307.79690843284;1220.7680540697238;1222.8226907098422;1226.9815952760716;1228.4103630257525;1244.3902487780922;21740.67388989198;24093.397665058514;24614.630780537947;24871;24987.87506062458;40994.1801163981;41319.38020929629;41464.3780343289;41724.74128880692;41913.37129942992;227303;227784;228904;229310;230262;26634.600480993187;26938.86530567413;27111.86444067767;27157.86421067882;27385.31536711598;35115.82442087773;35242.64757352496;35350.29299414049;35640.643593563735;35858.4621230687;30021.099367019026;30201.546976794925;30277.243068923453;30732.692673072983;30830.38339233158;29860.253493662833;29979.100626981224;29993.850030749705;30078.24804379908;30125.246868827577;29545.85227073851;30533.23666908345;30573;30753.692463075084;30883.227919302197;25306.746932531176;26704.732952670223;27035.729642704107;27129.321766955985;27175.59236611492;20642.17431302791;20826.791732082485;20830.479238018565;20867.582648347252;21050.2632407865 01:52:26 INFO - 2015-11-10 01:52:26,097 DEBUG : BROWSER_OUTPUT: |2;jquery.html;297.55218396313546;299.5177763800281;302.3740856427196;305.21559591848927;306.42545227698065;12642;12904.93547532261;14924.328405221764;14930.850691493082;15512.767308490382;10185.236107291945;10523.421211833345;10571.947140264288;13365.799513007289;15654.686906261868;3846.0961674006658;3964.940525892114;3965.781881996489;3967.642912137907;4002.4596679448337;3032.0449058546596;3115.1589070950945;3115.5793967814284;3765.3222419964395;3787.9621203787883;4133.0493986383;4254.085371645096;4264.253755592775;4286.378475121106;4303.376010478479;4037.4751282333254;4210.705250632457;4247.320428731419;4249.596288352602;4251.171021650779;3353.5137405076125;3392.457206846893;3439.5356626855305;3444.2594842109065;3448.1724386147143;11095.334279943228;11166.776664466746;11444.656660300205;11448.313101213871;11479.368634725086;1571.1123215383273;1691.6785810695928;1717.8368055034878;1782.3494424534952;1789.2842862854832;8240.381971352173;8397.412181147321;8398.412111152222;8496.362772792065;8627.223549880478;1344.9462021519128;1365.8497565267812;1367.384676895401;1395.3302414840832;1423.395057100728;50805.745971269906;51011;51075;51157.48842511565;52422.213666795025;5572.442755724395;5639.125935480007;5647.983362994701;5715.399883012307;5724.341700704473;6429.099926010363;6451.516136289703;6498.057781621733;6533.346665333524;6539.149910511698;4579.129965306581;4629.213033784265;4656.976715116402;4666.113438446684;4675.4155730533685;4922.138625740481;4938.407391113089;4941.579965702884;4960.429550601655;4982.252662100714;2586.430985183257;2589.495048465531;2598.2724837045657;2607.256931774435;2623.960640590393;909.2089881802874;911.9680811171577;912.7216199059351;918.6325469812128;984.247051005981;339.2874962578565;341.887177231513;362.6844645158729;372.07353689313413;380.4141621902295;9081;9465.100815422524;9467.147956683932;9521.857172142423;9661.565229564687;359.9568051833797;368.42525659970534;380.7810508957361;383.7409748419806;387.9282332768447;5449.972750136224;5486.369067557282;5487.067198576252;5521.613487055867;5606.719664016864;514370;514614;517996;523659;530729;59226;61512;61905;62453.687731561055;62986.37013629897;445.4587675973643;457.5744557561433;463.40452518513547;464.25718849839984;466.6546755401047;9301.534923253945;9482.146606805421;9538.904610953801;9628.75928101803;9689.757756056155;27760.58359124655;28099.71900281053;29047.709522905345;29147.271318216364;29524.114276571738;38059.23881522298;38139.61860381361;38617.42073868838;38636.80681596574;39176.608233918436;5259.89480210386;5367.463253674601;5389.730513474389;5398.973005134949;5433.266509021231;9799.804003919739;9965.800683986425;10110.69667909964;10110.747231319276;10195.133413659922;6921.00733941337;8437.325013998989;8845.601947912231;8873.511956842436;8874.023857375812;8439;8500.277476414574;8527.829443411221;8546.2308392245;8773.824523509622;8648.524331161847;8985.505797181218;9200.35597508168;9207;9209.21721653667;5373.086575282133;5374.704391258362;5438.075527160313;5442.23808666779;5453.890922181455;8808.955955220183;8973.685920992733;8983.595738191667;9015.774605634911;9024.323175761712 01:52:26 INFO - 2015-11-10 01:52:26,102 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1110.500274876305;1258.3519487463952;1485.1683057487808;1532.8160620725512;1652.7520871869222;6170.167027451293;6404.327545607714;7118.323759242877;7404.2965918237815;7414.925850741491;7078.292170782919;7203.567785932848;7255.1293844738575;7308.342249197571;7317.414606831454;1890.395073576456;1911.44568075258;1928.3540014095295;1931.6136772645457;1939.3212375668545;1967.0459826983902;1969.9901500492479;1983.5041239690077;2073.3676228750223;2075.6056349293663;1925.124068548814;1958.3048017953636;1960.6078784243136;1975.654260504406;1976.762788465379;2008.9196432142696;2016.5966806638658;2018.0010894607262;2025.5138766695961;2032.349648112612;1983.990080049605;1997.650411178038;2001.3995801259564;2049.241780541194;2078.5738923520644;6436.517261205428;7184.425245980309;7249.963750181268;7270.745523906638;7288.3804876585555;3875.2249550090096;3915.2169566086895;4222.345536441856;4269.850555230583;4314;2415.1426243683413;2493.887775050127;2520.6849143857016;2523.041244327162;2539.3143851160266;792.9960350198212;795.2167115391335;829.7967946477631;849.2441726863096;857.7212405968086;9465;9576.090271424204;9579.473128977903;9626.181774549172;9721.465319407429;3717.5167228260693;3740.5137332146646;3779.111908701453;3809.1429428378947;3826.6364695353896;7685.846283074307;7808.06303243603;7815.6482958267015;7817.68729250835;7911.28798408146;4317.330813723878;4318.050028993616;4324.156789426094;4328.480582330078;4334.631556317685;3989.740666856645;4004.1791432756213;4007.959920400817;4015.0765323975647;4021.6380525752825;3009.759219262454;3010.9397812043635;3043.6956304369387;3047.2229581456586;3065.0345141280427;943.2501161576563;955.4076472587041;955.9856602150974;960.5341409416427;964.5804075227159;1068.7007637861411;1152.982705259422;1197.5209916033657;1197.5449329255002;1197.9041676665845;6768.323167683192;6806.55757375769;6813.795586132324;6826;6840.726370945106;1080.3301952789163;1108.4125413530842;1132.767782604564;1138.6242539961793;1142.7543078238218;5113.360829896263;5376.677399356051;5379.246905433242;5379.973100134474;5419.918701219485;7933.246341597539;8351.1648835116;8535.871961920577;8614.87077693835;8629.654813807503;8391.202835730595;8441.915580844114;8442.62008209632;8489.151084891462;8525.44584601999;6630.668466576652;6791.932080679228;6861.142357205449;6862.348076932783;6883.827904302332;6497.610143391412;6529.4776417885505;6542.182227221598;6603.438707709898;6612.603243805387;7678.654460549177;7735.22647735222;7770.067591889009;7843.960780196291;7848.058233012075;7828.138904720362;7962.08436029864;7976.601169941596;7979.720709775363;7980.521168729895;5805.158252053344;6020.51835853122;6368.522360822864;6387.936120638734;6400.967995160181;6852.965735171292;6879.89680154788;6912.965435172792;6931.0643063187845;6931.965340173267;6325.873482530232;6332.810015699536;6384.148596906845;6510.804675859732;6556.377144171487;6279.654618995999;6302.779402720883;6316.873662526816;6335.239771227482;6429.58207716497;6387.137736405712;6505.381988711065;6506.056621789909;6506.837329066622;6521.217453905561;5752.482276595127;5767.279090113736;5830.679312637845;5834.124881267844;5877.059670452707;5942;5961.463468287875;6020.729067191899;6021.698915054318;6028.306744724413 01:52:26 INFO - 2015-11-10 01:52:26,102 DEBUG : BROWSER_OUTPUT: |4;prototype.html;274.63884991236523;280.1036682615629;281.2140068508519;283.1590177173794;289.20612917541354;5385.81149659762;5456.454354564542;5483.616146869721;5487.149491828768;5512.421195774441;5299.814506492274;5371.060064488718;5408.432114627956;5410.215518749779;5429.511343979041;4237.449131612886;4241.109367032911;4254.680898932577;4270.444842170514;4293.806778694959;4120.299549076649;4185.225733239346;4190.580941905816;4191.979040104795;4291.3777502262155;4186.895327616819;4217.283061879488;4221.598948099941;4224.915501689964;4230.936535951963;4210.894727631803;4216.936745948813;4219.1139860629155;4224.281872081723;4243.405923170759;3512.59605145409;3531.5585551806025;3545.3441113393847;3601.8559257629663;3615.981920090409;5043.36957880265;5247.344081989751;5264.578833693296;5283.682979021271;5286.36563612369;4626.514216007338;4632.166210082184;4645.814167433298;4683.95316046842;4702.36518070063;5564.527015203713;5596.804111856106;5633.971830140823;5642.379338272786;5644.238027866227;3773.6792372648356;3847.9230415391817;3862.4592557042038;3868.400397938296;3908.687305015592;5831.708414579339;5852.326982397036;5861.3552509223955;5883.882322353529;5937.67342796146;3915.5888631693833;3918.74528155669;3922.980385098056;3928.7642741435607;3970.630132604247;3953.0710283083454;3964.2269757397607;3976.0457490202143;3999.0402303446963;4006.559278479365;4556.2937744649635;4619.2378257587125;4630.907381852344;4633.536646335339;4694.061187762393;5626.943730562723;5628.71856407178;5681.914771278434;5683.119116536944;5701.657900525982;1438.1946110178333;1455.8471360506994;1461.4811741831497;1465.5530063330787;1469.7281003014477;941.8728471656376;950.2825366847985;958.5734348215117;964.5466630683568;970.9174720148867;5454.645448045864;5492.533134683516;5494.066008778517;5518.227448157261;5562;5931.288245410492;5939.554533410012;5963.105534169822;5979.222701048923;5990.101484777231;5518.19986102021;5519.420460851553;5550.500454959073;5550.8057217997175;5554.555635549227;3176.12656519459;3234;3240.935181296361;3285.4086264472626;3285.6221534523356;6009.248843894513;6017.849553761103;6116.235470566179;6123.693815309306;6135.601185922901;6036.215292012011;6091.8477038073515;6117;6125.938740612537;6145.661988590581;6095.573309868355;6145.508359331243;6156.353582873734;6186.81439556814;6187.133801267736;5768.365479797135;5894.793682221101;5929.970350148222;5976.521878249817;5992.910106348321;5866.149408335853;5876.294844618502;5882.794102206402;5910.349861515144;5921;6187.969060154671;6190.50475961913;6191.19514463117;6195.690215489118;6243.250809902841;3718.219173973496;3884.9223015538964;4063.715539912178;4070.715049946475;4084.0606660467665;5721.427857214412;5835.79574714883;5880.676562788916;5899.793507227227;5904.350521442724;5659.292588426447;5672.602917795714;5730.598858079894;5734.770609175586;5752.108423194411;5520.751566179451;5651.745671444713;5692.886142277214;5697.401772813795;5710.457506536873;5494.395616482264;5561.805336813192;5589.832305030855;5643.943560564506;5676.091825307931;5713.600047996601;5756.136579513107;5757.424257574209;5763.596548241583;5811.0121279381765;5637.746301416528;5653.462921022497;5655.4910058094965;5660.801871934627;5690.089585666439 01:52:26 INFO - 2015-11-10 01:52:26,106 DEBUG : BROWSER_OUTPUT: |5;yui.html;603.9396060393962;625.1154616218051;672.5258692621702;684.9623270720111;686.591478070548;9237.399569028017;9333.346665733392;9356.672516461926;9359.391639543443;9421.717348479548;10423.426711530863;10507.894921050787;10514.106300964408;10533.26267161297;10537.894621053787;772.4708574626371;781.3358645151604;790.3361176611673;790.5651891459703;790.8655528560158;763.1300317637897;784.051297929506;784.9058113026445;792.4809249941297;793.4961299574783;823.9546824924627;824.9546274954876;826.277007618334;830.8504469195542;831.0069466986953;814.9918500814975;819.0826274572457;819.4714409206058;822.0464261456711;829.9709510167145;611.4802417944755;612.0757655939564;614.8432149801816;615.5567991046439;617.478230894893;10785.083267922237;10863.83704244437;10976.585151266709;10981.505832237568;11060.834087488694;8827.558622068871;8879.330133035279;9009.144131307516;9298.442093474414;9328.580213890391;7529.548227106391;7823;7838.451308408414;7914.920850791534;8279.710210142677;2823.5764635304868;2833.7591304738917;2873.094975082842;2875.051233093095;2905.8111222770663;32450.837745811357;36614.43698941075;38313.80843095794;38662.613373866465;40681;5360.088784906575;5428.4028756836715;5573.359063707644;5578.63738856973;5665.688387138747;10151.9492402539;10184.745381365525;10263.281570290008;10323.94838025805;10331.12185464229;5044.9495505045215;5255.684658920477;5286.603504737083;5355.0896347621;5490.56075513958;3198.6297277380772;3213.4055199788113;3230.321632457163;3336.2993771308297;3339.231976645385;2425.478522117753;2447.0334217984155;2448.70615526138;2449.534588428193;2452.1662634704285;377.79221428214373;383.2430948876003;383.3521348920316;385.849518687712;386.74861340129144;415.84405847807074;439.68562477828505;477.90680817241;479.01323274055557;489.78204698908644;6529.510286728514;6581.243157036906;6637.701303441357;6705.2624211336715;6786;470.40493775374176;514.2928473349145;520.5445235419008;523.3275241314892;540.9632732761157;2545.630883521879;3098.62816462026;3188.139202415381;3284.507323901434;3307.6196237432523;47402.76298618485;47792.76103619529;47982.76008619935;48143.277850832266;51340.609236030425;40923.7953810229;41074.79462602727;41277.79361103235;42234.78882605567;43952.78023609926;30317.545236821465;38621.61378386236;39207.80396098001;39223;40659.796701016894;6637.137172167587;6645.098802783914;6846.760363387258;7175.964120179366;7236.240194779472;29693.703062969093;30083.849580751958;30444.086677399715;30911.454427278997;31095.689043110186;39263.60736392599;40098.79950600228;40450.59549404468;40548.391774124;40905.79547102245;5424.701641409761;6488.318726533835;6710.060591517094;6762.729490820312;6790.490713196431;9463;9539.189168920719;9602.807943841224;9604.9039509604;9686.75783105428;8854.690085846965;9100.22648074921;9175.77060573491;9185.954070229873;9187.908120918706;8728.738137855875;8870.77823054403;9098.026778723615;9286.117818807203;9323.860142097737;8542.301734046125;8785.604647790993;8816.074312197126;8819.735407937773;9143.817123657356;7473.663685134291;7683.385329173541;7833.647485863264;7996.827442621372;8296.128906464734;6806.7957961261245;6964.721411143498;7018.964905175441;7174.282571742784;7265.782026539212 01:52:26 INFO - 2015-11-10 01:52:26,106 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:52:26 INFO - 2015-11-10 01:52:26,106 DEBUG : BROWSER_OUTPUT: __start_cc_report 01:52:26 INFO - 2015-11-10 01:52:26,106 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,992 01:52:26 INFO - 2015-11-10 01:52:26,106 DEBUG : BROWSER_OUTPUT: __end_cc_report 01:52:26 INFO - 2015-11-10 01:52:26,107 DEBUG : BROWSER_OUTPUT: __startTimestamp1447149146090__endTimestamp 01:52:26 INFO - 2015-11-10 01:52:26,107 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,107 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:52:26 INFO - 2015-11-10 01:52:26,107 DEBUG : BROWSER_OUTPUT: Number of tests: 6 01:52:26 INFO - 2015-11-10 01:52:26,107 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,107 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4838.89 Median:4958.58 stddev:515.97 (10.4%) stddev-sans-first:491.70 01:52:26 INFO - 2015-11-10 01:52:26,107 DEBUG : BROWSER_OUTPUT: Values: 2782.9 2833.6 2855.3 2882.9 2898.5 4668.4 4695.2 4748.8 4816.3 4915.9 4714.3 4797.3 4825.4 4834.9 4836.5 4526.4 4542.0 4588.5 4622.4 4672.8 4634.9 4645.9 4656.1 4676.2 4722.9 4446.2 4448.7 4478.1 4524.4 4595.2 4538.7 4554.1 4567.2 4599.7 4610.5 4504.9 4528.1 4546.7 4571.7 4590.8 4633.2 4677.4 4754.1 4763.8 4800.2 5083.9 5100.5 5137.2 5152.3 5153.2 5208.8 5211.9 5218.2 5262.7 5270.9 4753.0 4755.6 4864.9 4870.5 4879.3 5309.1 5345.2 5349.3 5370.4 5455.3 5085.7 5090.8 5091.3 5108.4 5111.9 4916.1 5030.2 5196.3 5205.1 5292.2 5138.4 5147.4 5152.4 5169.9 5179.6 5142.4 5158.6 5168.2 5176.3 5210.5 3941.0 4017.3 4020.2 4027.1 4057.3 3570.3 3614.2 3646.9 3684.2 3686.0 4890.6 4911.0 4927.4 4932.5 4958.6 5013.2 5226.4 5233.4 5253.0 5287.9 4712.0 4739.8 4761.6 4852.3 4886.5 4570.5 4573.3 4620.3 4643.1 4647.0 5087.6 5355.4 5407.4 5408.9 5417.6 5105.2 5132.9 5169.9 5207.1 5220.5 5355.3 5397.2 5397.2 5412.1 5416.5 4981.6 5134.1 5191.5 5217.7 5243.7 5143.2 5144.5 5213.1 5229.9 5272.2 5094.9 5096.9 5110.8 5119.7 5152.4 4888.5 4904.7 5085.1 5097.9 5100.0 4852.3 4938.5 4945.2 4972.4 4980.8 5030.3 5044.0 5080.4 5103.6 5136.1 4816.0 4958.5 5010.3 5023.2 5054.7 01:52:26 INFO - 2015-11-10 01:52:26,108 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,108 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:38223.51 Median:30792.04 stddev:60131.83 (195.3%) stddev-sans-first:60233.80 01:52:26 INFO - 2015-11-10 01:52:26,108 DEBUG : BROWSER_OUTPUT: Values: 497.7 503.9 507.7 511.0 525.6 27207.7 28197.7 34782.8 35374.0 35398.3 36785.4 37357.0 37394.6 37401.4 37569.0 7201.3 7870.6 7939.2 8057.9 8062.2 7334.9 9349.7 9664.2 9665.1 9772.2 9428.1 9545.6 9553.4 9556.0 9703.2 7426.9 7568.5 9417.2 9546.2 9848.3 9449.0 9546.7 9575.7 9585.1 9611.7 34586.7 34613.0 35043.1 35057.6 35064.0 2627.3 2730.1 2809.7 2950.4 2979.9 23660.8 23717.3 24210.6 24288.1 25051.2 2043.4 2066.8 2076.0 2088.1 2151.7 240519.0 241322.0 243892.6 243916.0 245036.0 51434.5 51762.0 51817.5 51931.5 51969.7 47723.0 48648.3 59006.7 59601.4 60213.7 13022.5 13217.7 13359.2 13368.2 13376.2 9574.0 9605.3 9651.6 9724.0 9732.4 16787.7 17033.7 17079.8 17085.8 17131.9 6973.3 7098.1 7110.7 7137.9 7168.9 762.8 828.8 846.7 941.7 963.9 23839.6 24234.4 24320.9 24427.1 24729.8 918.9 935.2 961.0 997.7 1021.8 12691.5 12858.9 12885.4 13139.6 13738.1 217853.0 219751.0 222097.0 222335.0 222653.0 43469.1 43728.1 43735.0 44292.8 44307.8 1220.8 1222.8 1227.0 1228.4 1244.4 21740.7 24093.4 24614.6 24871.0 24987.9 40994.2 41319.4 41464.4 41724.7 41913.4 227303.0 227784.0 228904.0 229310.0 230262.0 26634.6 26938.9 27111.9 27157.9 27385.3 35115.8 35242.6 35350.3 35640.6 35858.5 30021.1 30201.5 30277.2 30732.7 30830.4 29860.3 29979.1 29993.9 30078.2 30125.2 29545.9 30533.2 30573.0 30753.7 30883.2 25306.7 26704.7 27035.7 27129.3 27175.6 20642.2 20826.8 20830.5 20867.6 21050.3 01:52:26 INFO - 2015-11-10 01:52:26,108 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,108 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:24325.54 Median:2566.38 stddev:85154.36 (3318.1%) stddev-sans-first:85374.13 01:52:26 INFO - 2015-11-10 01:52:26,110 DEBUG : BROWSER_OUTPUT: Values: 297.6 299.5 302.4 305.2 306.4 12642.0 12904.9 14924.3 14930.9 15512.8 10185.2 10523.4 10571.9 13365.8 15654.7 3846.1 3964.9 3965.8 3967.6 4002.5 3032.0 3115.2 3115.6 3765.3 3788.0 4133.0 4254.1 4264.3 4286.4 4303.4 4037.5 4210.7 4247.3 4249.6 4251.2 3353.5 3392.5 3439.5 3444.3 3448.2 11095.3 11166.8 11444.7 11448.3 11479.4 1571.1 1691.7 1717.8 1782.3 1789.3 8240.4 8397.4 8398.4 8496.4 8627.2 1344.9 1365.8 1367.4 1395.3 1423.4 50805.7 51011.0 51075.0 51157.5 52422.2 5572.4 5639.1 5648.0 5715.4 5724.3 6429.1 6451.5 6498.1 6533.3 6539.1 4579.1 4629.2 4657.0 4666.1 4675.4 4922.1 4938.4 4941.6 4960.4 4982.3 2586.4 2589.5 2598.3 2607.3 2624.0 909.2 912.0 912.7 918.6 984.2 339.3 341.9 362.7 372.1 380.4 9081.0 9465.1 9467.1 9521.9 9661.6 360.0 368.4 380.8 383.7 387.9 5450.0 5486.4 5487.1 5521.6 5606.7 514370.0 514614.0 517996.0 523659.0 530729.0 59226.0 61512.0 61905.0 62453.7 62986.4 445.5 457.6 463.4 464.3 466.7 9301.5 9482.1 9538.9 9628.8 9689.8 27760.6 28099.7 29047.7 29147.3 29524.1 38059.2 38139.6 38617.4 38636.8 39176.6 5259.9 5367.5 5389.7 5399.0 5433.3 9799.8 9965.8 10110.7 10110.7 10195.1 6921.0 8437.3 8845.6 8873.5 8874.0 8439.0 8500.3 8527.8 8546.2 8773.8 8648.5 8985.5 9200.4 9207.0 9209.2 5373.1 5374.7 5438.1 5442.2 5453.9 8809.0 8973.7 8983.6 9015.8 9024.3 01:52:26 INFO - 2015-11-10 01:52:26,110 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,110 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4945.44 Median:6321.37 stddev:2588.90 (41.0%) stddev-sans-first:2580.11 01:52:26 INFO - 2015-11-10 01:52:26,112 DEBUG : BROWSER_OUTPUT: Values: 1110.5 1258.4 1485.2 1532.8 1652.8 6170.2 6404.3 7118.3 7404.3 7414.9 7078.3 7203.6 7255.1 7308.3 7317.4 1890.4 1911.4 1928.4 1931.6 1939.3 1967.0 1970.0 1983.5 2073.4 2075.6 1925.1 1958.3 1960.6 1975.7 1976.8 2008.9 2016.6 2018.0 2025.5 2032.3 1984.0 1997.7 2001.4 2049.2 2078.6 6436.5 7184.4 7250.0 7270.7 7288.4 3875.2 3915.2 4222.3 4269.9 4314.0 2415.1 2493.9 2520.7 2523.0 2539.3 793.0 795.2 829.8 849.2 857.7 9465.0 9576.1 9579.5 9626.2 9721.5 3717.5 3740.5 3779.1 3809.1 3826.6 7685.8 7808.1 7815.6 7817.7 7911.3 4317.3 4318.1 4324.2 4328.5 4334.6 3989.7 4004.2 4008.0 4015.1 4021.6 3009.8 3010.9 3043.7 3047.2 3065.0 943.3 955.4 956.0 960.5 964.6 1068.7 1153.0 1197.5 1197.5 1197.9 6768.3 6806.6 6813.8 6826.0 6840.7 1080.3 1108.4 1132.8 1138.6 1142.8 5113.4 5376.7 5379.2 5380.0 5419.9 7933.2 8351.2 8535.9 8614.9 8629.7 8391.2 8441.9 8442.6 8489.2 8525.4 6630.7 6791.9 6861.1 6862.3 6883.8 6497.6 6529.5 6542.2 6603.4 6612.6 7678.7 7735.2 7770.1 7844.0 7848.1 7828.1 7962.1 7976.6 7979.7 7980.5 5805.2 6020.5 6368.5 6387.9 6401.0 6853.0 6879.9 6913.0 6931.1 6932.0 6325.9 6332.8 6384.1 6510.8 6556.4 6279.7 6302.8 6316.9 6335.2 6429.6 6387.1 6505.4 6506.1 6506.8 6521.2 5752.5 5767.3 5830.7 5834.1 5877.1 5942.0 5961.5 6020.7 6021.7 6028.3 01:52:26 INFO - 2015-11-10 01:52:26,112 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,112 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4783.66 Median:5518.82 stddev:1449.44 (26.3%) stddev-sans-first:1413.44 01:52:26 INFO - 2015-11-10 01:52:26,113 DEBUG : BROWSER_OUTPUT: Values: 274.6 280.1 281.2 283.2 289.2 5385.8 5456.5 5483.6 5487.1 5512.4 5299.8 5371.1 5408.4 5410.2 5429.5 4237.4 4241.1 4254.7 4270.4 4293.8 4120.3 4185.2 4190.6 4192.0 4291.4 4186.9 4217.3 4221.6 4224.9 4230.9 4210.9 4216.9 4219.1 4224.3 4243.4 3512.6 3531.6 3545.3 3601.9 3616.0 5043.4 5247.3 5264.6 5283.7 5286.4 4626.5 4632.2 4645.8 4684.0 4702.4 5564.5 5596.8 5634.0 5642.4 5644.2 3773.7 3847.9 3862.5 3868.4 3908.7 5831.7 5852.3 5861.4 5883.9 5937.7 3915.6 3918.7 3923.0 3928.8 3970.6 3953.1 3964.2 3976.0 3999.0 4006.6 4556.3 4619.2 4630.9 4633.5 4694.1 5626.9 5628.7 5681.9 5683.1 5701.7 1438.2 1455.8 1461.5 1465.6 1469.7 941.9 950.3 958.6 964.5 970.9 5454.6 5492.5 5494.1 5518.2 5562.0 5931.3 5939.6 5963.1 5979.2 5990.1 5518.2 5519.4 5550.5 5550.8 5554.6 3176.1 3234.0 3240.9 3285.4 3285.6 6009.2 6017.8 6116.2 6123.7 6135.6 6036.2 6091.8 6117.0 6125.9 6145.7 6095.6 6145.5 6156.4 6186.8 6187.1 5768.4 5894.8 5930.0 5976.5 5992.9 5866.1 5876.3 5882.8 5910.3 5921.0 6188.0 6190.5 6191.2 6195.7 6243.3 3718.2 3884.9 4063.7 4070.7 4084.1 5721.4 5835.8 5880.7 5899.8 5904.4 5659.3 5672.6 5730.6 5734.8 5752.1 5520.8 5651.7 5692.9 5697.4 5710.5 5494.4 5561.8 5589.8 5643.9 5676.1 5713.6 5756.1 5757.4 5763.6 5811.0 5637.7 5653.5 5655.5 5660.8 5690.1 01:52:26 INFO - 2015-11-10 01:52:26,113 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,113 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:10939.30 Median:3134.81 stddev:13398.73 (427.4%) stddev-sans-first:13413.84 01:52:26 INFO - 2015-11-10 01:52:26,115 DEBUG : BROWSER_OUTPUT: Values: 603.9 625.1 672.5 685.0 686.6 9237.4 9333.3 9356.7 9359.4 9421.7 10423.4 10507.9 10514.1 10533.3 10537.9 772.5 781.3 790.3 790.6 790.9 763.1 784.1 784.9 792.5 793.5 824.0 825.0 826.3 830.9 831.0 815.0 819.1 819.5 822.0 830.0 611.5 612.1 614.8 615.6 617.5 10785.1 10863.8 10976.6 10981.5 11060.8 8827.6 8879.3 9009.1 9298.4 9328.6 7529.5 7823.0 7838.5 7914.9 8279.7 2823.6 2833.8 2873.1 2875.1 2905.8 32450.8 36614.4 38313.8 38662.6 40681.0 5360.1 5428.4 5573.4 5578.6 5665.7 10151.9 10184.7 10263.3 10323.9 10331.1 5044.9 5255.7 5286.6 5355.1 5490.6 3198.6 3213.4 3230.3 3336.3 3339.2 2425.5 2447.0 2448.7 2449.5 2452.2 377.8 383.2 383.4 385.8 386.7 415.8 439.7 477.9 479.0 489.8 6529.5 6581.2 6637.7 6705.3 6786.0 470.4 514.3 520.5 523.3 541.0 2545.6 3098.6 3188.1 3284.5 3307.6 47402.8 47792.8 47982.8 48143.3 51340.6 40923.8 41074.8 41277.8 42234.8 43952.8 30317.5 38621.6 39207.8 39223.0 40659.8 6637.1 6645.1 6846.8 7176.0 7236.2 29693.7 30083.8 30444.1 30911.5 31095.7 39263.6 40098.8 40450.6 40548.4 40905.8 5424.7 6488.3 6710.1 6762.7 6790.5 9463.0 9539.2 9602.8 9604.9 9686.8 8854.7 9100.2 9175.8 9186.0 9187.9 8728.7 8870.8 9098.0 9286.1 9323.9 8542.3 8785.6 8816.1 8819.7 9143.8 7473.7 7683.4 7833.6 7996.8 8296.1 6806.8 6964.7 7019.0 7174.3 7265.8 01:52:26 INFO - 2015-11-10 01:52:26,115 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:52:26 INFO - 2015-11-10 01:52:26,115 DEBUG : BROWSER_OUTPUT: 01:52:26 INFO - 2015-11-10 01:52:26,772 INFO : Browser exited with error code: 0 01:52:26 INFO - 2015-11-10 01:52:26,803 INFO : Completed test dromaeo_css (00:18:35) 01:52:26 INFO - 2015-11-10 01:52:26,803 INFO : Starting test kraken 01:52:26 INFO - 2015-11-10 01:52:26,803 DEBUG : operating with platform_type : mac_ 01:52:26 INFO - 2015-11-10 01:52:26,803 INFO : Initialising browser for kraken test... 01:52:26 INFO - 2015-11-10 01:52:26,818 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/tmp_iU8Pr/profile http://localhost:49508/getInfo.html 01:52:29 INFO - 2015-11-10 01:52:29,472 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:52:29 INFO - 2015-11-10 01:52:29,472 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:52:29 INFO - 2015-11-10 01:52:29,472 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 01:52:29 INFO - 2015-11-10 01:52:29,472 DEBUG : BROWSER_OUTPUT: __metrics 01:52:29 INFO - 2015-11-10 01:52:29,488 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:52:30 INFO - 2015-11-10 01:52:30,222 INFO : Browser initialized. 01:52:30 INFO - 2015-11-10 01:52:30,222 INFO : Running cycle 1/1 for kraken test... 01:52:30 INFO - 2015-11-10 01:52:30,223 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/tmp_iU8Pr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:52:42 INFO - 2015-11-10 01:52:42,452 DEBUG : BROWSER_OUTPUT: RSS: Main: 229896192 01:52:42 INFO - 2015-11-10 01:52:42,452 DEBUG : BROWSER_OUTPUT: 01:52:45 INFO - 2015-11-10 01:52:45,266 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49508/tests/kraken/driver.html?testName=audio-beat-detection) 01:52:45 INFO - 2015-11-10 01:52:45,865 DEBUG : BROWSER_OUTPUT: RSS: Main: 285212672 01:52:45 INFO - 2015-11-10 01:52:45,865 DEBUG : BROWSER_OUTPUT: 01:52:48 INFO - 2015-11-10 01:52:48,781 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49508/tests/kraken/driver.html?testName=audio-dft) 01:52:49 INFO - 2015-11-10 01:52:49,374 DEBUG : BROWSER_OUTPUT: RSS: Main: 298844160 01:52:49 INFO - 2015-11-10 01:52:49,375 DEBUG : BROWSER_OUTPUT: 01:52:52 INFO - 2015-11-10 01:52:52,617 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49508/tests/kraken/driver.html?testName=audio-fft) 01:52:53 INFO - 2015-11-10 01:52:53,195 DEBUG : BROWSER_OUTPUT: RSS: Main: 282914816 01:52:53 INFO - 2015-11-10 01:52:53,195 DEBUG : BROWSER_OUTPUT: 01:52:55 INFO - 2015-11-10 01:52:55,418 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49508/tests/kraken/driver.html?testName=audio-oscillator) 01:52:56 INFO - 2015-11-10 01:52:56,009 DEBUG : BROWSER_OUTPUT: RSS: Main: 283090944 01:52:56 INFO - 2015-11-10 01:52:56,009 DEBUG : BROWSER_OUTPUT: 01:52:58 INFO - 2015-11-10 01:52:58,401 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49508/tests/kraken/driver.html?testName=imaging-gaussian-blur) 01:52:58 INFO - 2015-11-10 01:52:58,984 DEBUG : BROWSER_OUTPUT: RSS: Main: 283881472 01:52:58 INFO - 2015-11-10 01:52:58,984 DEBUG : BROWSER_OUTPUT: 01:53:02 INFO - 2015-11-10 01:53:02,347 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49508/tests/kraken/driver.html?testName=imaging-darkroom) 01:53:02 INFO - 2015-11-10 01:53:02,935 DEBUG : BROWSER_OUTPUT: RSS: Main: 283308032 01:53:02 INFO - 2015-11-10 01:53:02,935 DEBUG : BROWSER_OUTPUT: 01:53:06 INFO - 2015-11-10 01:53:06,397 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49508/tests/kraken/driver.html?testName=imaging-desaturate) 01:53:06 INFO - 2015-11-10 01:53:06,985 DEBUG : BROWSER_OUTPUT: RSS: Main: 284913664 01:53:06 INFO - 2015-11-10 01:53:06,985 DEBUG : BROWSER_OUTPUT: 01:53:10 INFO - 2015-11-10 01:53:10,175 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49508/tests/kraken/driver.html?testName=json-parse-financial) 01:53:10 INFO - 2015-11-10 01:53:10,761 DEBUG : BROWSER_OUTPUT: RSS: Main: 285822976 01:53:10 INFO - 2015-11-10 01:53:10,761 DEBUG : BROWSER_OUTPUT: 01:53:12 INFO - 2015-11-10 01:53:12,431 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49508/tests/kraken/driver.html?testName=json-stringify-tinderbox) 01:53:13 INFO - 2015-11-10 01:53:13,005 DEBUG : BROWSER_OUTPUT: RSS: Main: 321327104 01:53:13 INFO - 2015-11-10 01:53:13,006 DEBUG : BROWSER_OUTPUT: 01:53:14 INFO - 2015-11-10 01:53:14,972 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49508/tests/kraken/driver.html?testName=stanford-crypto-aes) 01:53:15 INFO - 2015-11-10 01:53:15,597 DEBUG : BROWSER_OUTPUT: RSS: Main: 322228224 01:53:15 INFO - 2015-11-10 01:53:15,597 DEBUG : BROWSER_OUTPUT: 01:53:17 INFO - 2015-11-10 01:53:17,894 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49508/tests/kraken/driver.html?testName=stanford-crypto-ccm) 01:53:18 INFO - 2015-11-10 01:53:18,484 DEBUG : BROWSER_OUTPUT: RSS: Main: 327876608 01:53:18 INFO - 2015-11-10 01:53:18,484 DEBUG : BROWSER_OUTPUT: 01:53:21 INFO - 2015-11-10 01:53:21,332 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49508/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 01:53:21 INFO - 2015-11-10 01:53:21,923 DEBUG : BROWSER_OUTPUT: RSS: Main: 330579968 01:53:21 INFO - 2015-11-10 01:53:21,924 DEBUG : BROWSER_OUTPUT: 01:53:24 INFO - 2015-11-10 01:53:24,845 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49508/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 01:53:25 INFO - 2015-11-10 01:53:25,433 DEBUG : BROWSER_OUTPUT: RSS: Main: 329154560 01:53:25 INFO - 2015-11-10 01:53:25,433 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,327 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49508/tests/kraken/driver.html?testName=ai-astar) 01:53:27 INFO - 2015-11-10 01:53:27,581 DEBUG : BROWSER_OUTPUT: RSS: Main: 387899392 01:53:27 INFO - 2015-11-10 01:53:27,581 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,581 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:53:27 INFO - 2015-11-10 01:53:27,581 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:53:27 INFO - 2015-11-10 01:53:27,582 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:53:27 INFO - 2015-11-10 01:53:27,582 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:53:27 INFO - 2015-11-10 01:53:27,582 DEBUG : BROWSER_OUTPUT: |0;ai-astar;120;115;128;126;120;119;127;127;127;120 01:53:27 INFO - 2015-11-10 01:53:27,582 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;178;151;172;185;143;173;170;146;182;142 01:53:27 INFO - 2015-11-10 01:53:27,583 DEBUG : BROWSER_OUTPUT: |2;audio-dft;179;179;189;183;179;181;181;190;186;181 01:53:27 INFO - 2015-11-10 01:53:27,583 DEBUG : BROWSER_OUTPUT: |3;audio-fft;78;93;94;138;78;80;80;77;125;75 01:53:27 INFO - 2015-11-10 01:53:27,583 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;110;113;158;103;103;103;142;98;104;151 01:53:27 INFO - 2015-11-10 01:53:27,583 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;131;136;134;130;130;135;131;129;129;142 01:53:27 INFO - 2015-11-10 01:53:27,583 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;141;148;144;141;142;148;143;141;141;147 01:53:27 INFO - 2015-11-10 01:53:27,583 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;118;118;114;113;119;117;116;115;118;120 01:53:27 INFO - 2015-11-10 01:53:27,583 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;61;65;65;65;67;67;68;75;62;64 01:53:27 INFO - 2015-11-10 01:53:27,584 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;73;74;74;77;78;83;79;77;75;76 01:53:27 INFO - 2015-11-10 01:53:27,584 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;97;100;100;100;97;96;96;101;105;101 01:53:27 INFO - 2015-11-10 01:53:27,584 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;151;147;152;144;150;144;137;143;149;144 01:53:27 INFO - 2015-11-10 01:53:27,584 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;174;173;180;172;183;163;175;182;185;174 01:53:27 INFO - 2015-11-10 01:53:27,584 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;80;84;85;86;85;81;83;82;82;82 01:53:27 INFO - 2015-11-10 01:53:27,584 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:53:27 INFO - 2015-11-10 01:53:27,585 DEBUG : BROWSER_OUTPUT: __start_cc_report 01:53:27 INFO - 2015-11-10 01:53:27,585 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,952 01:53:27 INFO - 2015-11-10 01:53:27,585 DEBUG : BROWSER_OUTPUT: __end_cc_report 01:53:27 INFO - 2015-11-10 01:53:27,586 DEBUG : BROWSER_OUTPUT: __startTimestamp1447149207580__endTimestamp 01:53:27 INFO - 2015-11-10 01:53:27,587 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,587 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:53:27 INFO - 2015-11-10 01:53:27,587 DEBUG : BROWSER_OUTPUT: Number of tests: 14 01:53:27 INFO - 2015-11-10 01:53:27,587 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,587 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:122.90 Median:126.50 stddev:4.58 (3.6%) stddev-sans-first:4.74 01:53:27 INFO - 2015-11-10 01:53:27,588 DEBUG : BROWSER_OUTPUT: Values: 120.0 115.0 128.0 126.0 120.0 119.0 127.0 127.0 127.0 120.0 01:53:27 INFO - 2015-11-10 01:53:27,588 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,588 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:164.20 Median:172.50 stddev:16.86 (9.8%) stddev-sans-first:17.13 01:53:27 INFO - 2015-11-10 01:53:27,588 DEBUG : BROWSER_OUTPUT: Values: 178.0 151.0 172.0 185.0 143.0 173.0 170.0 146.0 182.0 142.0 01:53:27 INFO - 2015-11-10 01:53:27,588 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,589 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:182.80 Median:182.00 stddev:4.13 (2.3%) stddev-sans-first:4.15 01:53:27 INFO - 2015-11-10 01:53:27,589 DEBUG : BROWSER_OUTPUT: Values: 179.0 179.0 189.0 183.0 179.0 181.0 181.0 190.0 186.0 181.0 01:53:27 INFO - 2015-11-10 01:53:27,589 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,589 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:91.80 Median:79.00 stddev:22.12 (28.0%) stddev-sans-first:22.89 01:53:27 INFO - 2015-11-10 01:53:27,589 DEBUG : BROWSER_OUTPUT: Values: 78.0 93.0 94.0 138.0 78.0 80.0 80.0 77.0 125.0 75.0 01:53:27 INFO - 2015-11-10 01:53:27,590 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,590 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:118.50 Median:127.50 stddev:22.66 (17.8%) stddev-sans-first:23.83 01:53:27 INFO - 2015-11-10 01:53:27,590 DEBUG : BROWSER_OUTPUT: Values: 110.0 113.0 158.0 103.0 103.0 103.0 142.0 98.0 104.0 151.0 01:53:27 INFO - 2015-11-10 01:53:27,590 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,590 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:132.70 Median:132.50 stddev:4.11 (3.1%) stddev-sans-first:4.31 01:53:27 INFO - 2015-11-10 01:53:27,590 DEBUG : BROWSER_OUTPUT: Values: 131.0 136.0 134.0 130.0 130.0 135.0 131.0 129.0 129.0 142.0 01:53:27 INFO - 2015-11-10 01:53:27,591 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,591 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:143.60 Median:143.50 stddev:2.99 (2.1%) stddev-sans-first:3.02 01:53:27 INFO - 2015-11-10 01:53:27,591 DEBUG : BROWSER_OUTPUT: Values: 141.0 148.0 144.0 141.0 142.0 148.0 143.0 141.0 141.0 147.0 01:53:27 INFO - 2015-11-10 01:53:27,591 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,591 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:116.80 Median:118.00 stddev:2.25 (1.9%) stddev-sans-first:2.35 01:53:27 INFO - 2015-11-10 01:53:27,591 DEBUG : BROWSER_OUTPUT: Values: 118.0 118.0 114.0 113.0 119.0 117.0 116.0 115.0 118.0 120.0 01:53:27 INFO - 2015-11-10 01:53:27,591 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,592 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:65.90 Median:66.00 stddev:3.87 (5.9%) stddev-sans-first:3.68 01:53:27 INFO - 2015-11-10 01:53:27,592 DEBUG : BROWSER_OUTPUT: Values: 61.0 65.0 65.0 65.0 67.0 67.0 68.0 75.0 62.0 64.0 01:53:27 INFO - 2015-11-10 01:53:27,592 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,592 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:76.60 Median:77.00 stddev:2.95 (3.8%) stddev-sans-first:2.83 01:53:27 INFO - 2015-11-10 01:53:27,592 DEBUG : BROWSER_OUTPUT: Values: 73.0 74.0 74.0 77.0 78.0 83.0 79.0 77.0 75.0 76.0 01:53:27 INFO - 2015-11-10 01:53:27,592 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,593 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:99.30 Median:100.50 stddev:2.83 (2.8%) stddev-sans-first:2.88 01:53:27 INFO - 2015-11-10 01:53:27,593 DEBUG : BROWSER_OUTPUT: Values: 97.0 100.0 100.0 100.0 97.0 96.0 96.0 101.0 105.0 101.0 01:53:27 INFO - 2015-11-10 01:53:27,593 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,593 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:146.10 Median:148.00 stddev:4.58 (3.1%) stddev-sans-first:4.50 01:53:27 INFO - 2015-11-10 01:53:27,595 DEBUG : BROWSER_OUTPUT: Values: 151.0 147.0 152.0 144.0 150.0 144.0 137.0 143.0 149.0 144.0 01:53:27 INFO - 2015-11-10 01:53:27,595 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,595 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:176.10 Median:177.50 stddev:6.54 (3.7%) stddev-sans-first:6.89 01:53:27 INFO - 2015-11-10 01:53:27,595 DEBUG : BROWSER_OUTPUT: Values: 174.0 173.0 180.0 172.0 183.0 163.0 175.0 182.0 185.0 174.0 01:53:27 INFO - 2015-11-10 01:53:27,595 DEBUG : BROWSER_OUTPUT: 01:53:27 INFO - 2015-11-10 01:53:27,596 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:83.00 Median:83.50 stddev:1.94 (2.3%) stddev-sans-first:1.73 01:53:27 INFO - 2015-11-10 01:53:27,596 DEBUG : BROWSER_OUTPUT: Values: 80.0 84.0 85.0 86.0 85.0 81.0 83.0 82.0 82.0 82.0 01:53:27 INFO - 2015-11-10 01:53:27,596 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:53:27 INFO - 2015-11-10 01:53:27,596 DEBUG : BROWSER_OUTPUT: 01:53:28 INFO - 2015-11-10 01:53:28,318 INFO : Browser exited with error code: 0 01:53:28 INFO - 2015-11-10 01:53:28,372 INFO : Completed test kraken (00:01:01) 01:53:28 INFO - 2015-11-10 01:53:28,372 INFO : Starting test v8_7 01:53:28 INFO - 2015-11-10 01:53:28,372 DEBUG : operating with platform_type : mac_ 01:53:28 INFO - 2015-11-10 01:53:28,373 INFO : Initialising browser for v8_7 test... 01:53:28 INFO - 2015-11-10 01:53:28,387 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/tmp4QKRi0/profile http://localhost:49508/getInfo.html 01:53:30 INFO - 2015-11-10 01:53:30,947 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:53:30 INFO - 2015-11-10 01:53:30,947 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:53:30 INFO - 2015-11-10 01:53:30,947 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 01:53:30 INFO - 2015-11-10 01:53:30,947 DEBUG : BROWSER_OUTPUT: __metrics 01:53:30 INFO - 2015-11-10 01:53:30,966 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:53:31 INFO - 2015-11-10 01:53:31,683 INFO : Browser initialized. 01:53:31 INFO - 2015-11-10 01:53:31,683 INFO : Running cycle 1/1 for v8_7 test... 01:53:31 INFO - 2015-11-10 01:53:31,683 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/T/tmp4QKRi0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:53:43 INFO - 2015-11-10 01:53:43,911 DEBUG : BROWSER_OUTPUT: RSS: Main: 229126144 01:53:43 INFO - 2015-11-10 01:53:43,911 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,706 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49508/tests/v8_7/run.html (next: http://localhost:49508/tests/v8_7/run.html) 01:54:06 INFO - 2015-11-10 01:54:06,955 DEBUG : BROWSER_OUTPUT: RSS: Main: 728449024 01:54:06 INFO - 2015-11-10 01:54:06,955 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,955 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:54:06 INFO - 2015-11-10 01:54:06,955 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:54:06 INFO - 2015-11-10 01:54:06,955 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:54:06 INFO - 2015-11-10 01:54:06,955 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:54:06 INFO - 2015-11-10 01:54:06,956 DEBUG : BROWSER_OUTPUT: |0;Richards;188.57250612860645 01:54:06 INFO - 2015-11-10 01:54:06,956 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;216.3097555699762 01:54:06 INFO - 2015-11-10 01:54:06,956 DEBUG : BROWSER_OUTPUT: |2;Encrypt;363.10820624546113 01:54:06 INFO - 2015-11-10 01:54:06,956 DEBUG : BROWSER_OUTPUT: |3;Decrypt;6451.612903225807 01:54:06 INFO - 2015-11-10 01:54:06,956 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2131.9148936170213 01:54:06 INFO - 2015-11-10 01:54:06,956 DEBUG : BROWSER_OUTPUT: |5;Earley;1014.1987829614604 01:54:06 INFO - 2015-11-10 01:54:06,957 DEBUG : BROWSER_OUTPUT: |6;Boyer;13972.222222222223 01:54:06 INFO - 2015-11-10 01:54:06,957 DEBUG : BROWSER_OUTPUT: |7;RegExp;32661.290322580644 01:54:06 INFO - 2015-11-10 01:54:06,957 DEBUG : BROWSER_OUTPUT: |8;Splay;1006.993006993007 01:54:06 INFO - 2015-11-10 01:54:06,957 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;6410.25641025641 01:54:06 INFO - 2015-11-10 01:54:06,957 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:54:06 INFO - 2015-11-10 01:54:06,957 DEBUG : BROWSER_OUTPUT: __startTimestamp1447149246953__endTimestamp 01:54:06 INFO - 2015-11-10 01:54:06,957 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,958 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:54:06 INFO - 2015-11-10 01:54:06,958 DEBUG : BROWSER_OUTPUT: Number of tests: 10 01:54:06 INFO - 2015-11-10 01:54:06,958 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,958 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:188.57 Median:188.57 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,958 DEBUG : BROWSER_OUTPUT: Values: 188.6 01:54:06 INFO - 2015-11-10 01:54:06,958 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,958 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:216.31 Median:216.31 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,958 DEBUG : BROWSER_OUTPUT: Values: 216.3 01:54:06 INFO - 2015-11-10 01:54:06,959 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,960 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:363.11 Median:363.11 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,960 DEBUG : BROWSER_OUTPUT: Values: 363.1 01:54:06 INFO - 2015-11-10 01:54:06,960 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,960 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:6451.61 Median:6451.61 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,960 DEBUG : BROWSER_OUTPUT: Values: 6451.6 01:54:06 INFO - 2015-11-10 01:54:06,960 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,960 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2131.91 Median:2131.91 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,961 DEBUG : BROWSER_OUTPUT: Values: 2131.9 01:54:06 INFO - 2015-11-10 01:54:06,961 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,961 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:1014.20 Median:1014.20 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,961 DEBUG : BROWSER_OUTPUT: Values: 1014.2 01:54:06 INFO - 2015-11-10 01:54:06,961 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,961 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:13972.22 Median:13972.22 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,961 DEBUG : BROWSER_OUTPUT: Values: 13972.2 01:54:06 INFO - 2015-11-10 01:54:06,961 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:32661.29 Median:32661.29 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: Values: 32661.3 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:1006.99 Median:1006.99 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: Values: 1007.0 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:6410.26 Median:6410.26 stddev:0.00 (0.0%) 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: Values: 6410.3 01:54:06 INFO - 2015-11-10 01:54:06,962 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:54:06 INFO - 2015-11-10 01:54:06,963 DEBUG : BROWSER_OUTPUT: 01:54:07 INFO - 2015-11-10 01:54:07,719 INFO : Browser exited with error code: 0 01:54:07 INFO - 2015-11-10 01:54:07,740 INFO : Completed test v8_7 (00:00:39) 01:54:07 INFO - 2015-11-10 01:54:07,758 INFO : Completed test suite (00:20:16) 01:54:07 INFO - 2015-11-10 01:54:07,758 DEBUG : Working with test: dromaeo_css 01:54:07 INFO - 2015-11-10 01:54:07,758 DEBUG : Generating results file: dromaeo_css 01:54:07 INFO - 2015-11-10 01:54:07,759 DEBUG : Working with test: kraken 01:54:07 INFO - 2015-11-10 01:54:07,759 DEBUG : Generating results file: kraken 01:54:07 INFO - 2015-11-10 01:54:07,759 INFO : javascript benchmark 01:54:07 INFO - 2015-11-10 01:54:07,759 DEBUG : Working with test: v8_7 01:54:07 INFO - 2015-11-10 01:54:07,760 DEBUG : Generating results file: v8_7 01:54:07 INFO - 2015-11-10 01:54:07,760 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:54:07 INFO - 2015-11-10 01:54:07,812 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,63,55]] 01:54:07 INFO - 2015-11-10 01:54:07,812 DEBUG : process_Request line: dromaeo_css 5791.85 graph.html#tests=[[72,63,55]] 01:54:07 INFO - 2015-11-10 01:54:07,812 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:54:07 INFO - 2015-11-10 01:54:07,843 DEBUG : process_Request line: kraken 1720.30 graph.html#tests=[[232,63,55]] 01:54:07 INFO - 2015-11-10 01:54:07,843 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:54:07 INFO - 2015-11-10 01:54:07,870 DEBUG : process_Request line: v8_7 15899.64 graph.html#tests=[[230,63,55]] 01:54:07 INFO - 2015-11-10 01:54:07,871 INFO : javascript benchmark 01:54:07 INFO - 2015-11-10 01:54:07,873 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [297.55218396313546, 299.5177763800281, 302.3740856427196, 305.21559591848927, 306.42545227698065, 12642.0, 12904.93547532261, 14924.328405221764, 14930.850691493082, 15512.767308490382, 10185.236107291945, 10523.421211833345, 10571.947140264288, 13365.799513007289, 15654.686906261868, 3846.0961674006658, 3964.940525892114, 3965.781881996489, 3967.642912137907, 4002.4596679448337, 3032.0449058546596, 3115.1589070950945, 3115.5793967814284, 3765.3222419964395, 3787.9621203787883, 4133.0493986383, 4254.085371645096, 4264.253755592775, 4286.378475121106, 4303.376010478479, 4037.4751282333254, 4210.705250632457, 4247.320428731419, 4249.596288352602, 4251.171021650779, 3353.5137405076125, 3392.457206846893, 3439.5356626855305, 3444.2594842109065, 3448.1724386147143, 11095.334279943228, 11166.776664466746, 11444.656660300205, 11448.313101213871, 11479.368634725086, 1571.1123215383273, 1691.6785810695928, 1717.8368055034878, 1782.3494424534952, 1789.2842862854832, 8240.381971352173, 8397.412181147321, 8398.412111152222, 8496.362772792065, 8627.223549880478, 1344.9462021519128, 1365.8497565267812, 1367.384676895401, 1395.3302414840832, 1423.395057100728, 50805.745971269906, 51011.0, 51075.0, 51157.48842511565, 52422.213666795025, 5572.442755724395, 5639.125935480007, 5647.983362994701, 5715.399883012307, 5724.341700704473, 6429.099926010363, 6451.516136289703, 6498.057781621733, 6533.346665333524, 6539.149910511698, 4579.129965306581, 4629.213033784265, 4656.976715116402, 4666.113438446684, 4675.4155730533685, 4922.138625740481, 4938.407391113089, 4941.579965702884, 4960.429550601655, 4982.252662100714, 2586.430985183257, 2589.495048465531, 2598.2724837045657, 2607.256931774435, 2623.960640590393, 909.2089881802874, 911.9680811171577, 912.7216199059351, 918.6325469812128, 984.247051005981, 339.2874962578565, 341.887177231513, 362.6844645158729, 372.07353689313413, 380.4141621902295, 9081.0, 9465.100815422524, 9467.147956683932, 9521.857172142423, 9661.565229564687, 359.9568051833797, 368.42525659970534, 380.7810508957361, 383.7409748419806, 387.9282332768447, 5449.972750136224, 5486.369067557282, 5487.067198576252, 5521.613487055867, 5606.719664016864, 514370.0, 514614.0, 517996.0, 523659.0, 530729.0, 59226.0, 61512.0, 61905.0, 62453.687731561055, 62986.37013629897, 445.4587675973643, 457.5744557561433, 463.40452518513547, 464.25718849839984, 466.6546755401047, 9301.534923253945, 9482.146606805421, 9538.904610953801, 9628.75928101803, 9689.757756056155, 27760.58359124655, 28099.71900281053, 29047.709522905345, 29147.271318216364, 29524.114276571738, 38059.23881522298, 38139.61860381361, 38617.42073868838, 38636.80681596574, 39176.608233918436, 5259.89480210386, 5367.463253674601, 5389.730513474389, 5398.973005134949, 5433.266509021231, 9799.804003919739, 9965.800683986425, 10110.69667909964, 10110.747231319276, 10195.133413659922, 6921.00733941337, 8437.325013998989, 8845.601947912231, 8873.511956842436, 8874.023857375812, 8439.0, 8500.277476414574, 8527.829443411221, 8546.2308392245, 8773.824523509622, 8648.524331161847, 8985.505797181218, 9200.35597508168, 9207.0, 9209.21721653667, 5373.086575282133, 5374.704391258362, 5438.075527160313, 5442.23808666779, 5453.890922181455, 8808.955955220183, 8973.685920992733, 8983.595738191667, 9015.774605634911, 9024.323175761712], "dojo.html": [2782.9165125046247, 2833.617461642679, 2855.2719056640553, 2882.942341153177, 2898.4782739106954, 4668.393108895847, 4695.2252878275085, 4748.786304616292, 4816.277558366247, 4915.852524424264, 4714.339992401066, 4797.280407938802, 4825.396825396817, 4834.9274760878525, 4836.516348365161, 4526.411566496367, 4541.977290113545, 4588.49526552079, 4622.422197225347, 4672.836450724225, 4634.884127896796, 4645.860624181263, 4656.092062047902, 4676.158291507527, 4722.858314250578, 4446.177457170434, 4448.6885917985755, 4478.149151661174, 4524.389207456984, 4595.1728688836165, 4538.704984176051, 4554.066416384666, 4567.177907976563, 4599.747013914233, 4610.4697959734385, 4504.864854054384, 4528.139653465831, 4546.704464209815, 4571.72569645819, 4590.839320623795, 4633.189191891405, 4677.438707355105, 4754.144254034272, 4763.785629646674, 4800.231962885921, 5083.872903177413, 5100.540951314362, 5137.17805151174, 5152.252923326097, 5153.2270159476, 5208.843734687927, 5211.869703257411, 5218.165093585008, 5262.736863156827, 5270.894582108336, 4753.04939012199, 4755.595774359183, 4864.902701945976, 4870.488598697157, 4879.341288926021, 5309.070912590281, 5345.1982202669915, 5349.277847490617, 5370.436104209002, 5455.263539422207, 5085.74571271435, 5090.796368145233, 5091.338126043591, 5108.412532558803, 5111.948880511221, 4916.139675556763, 5030.195168772979, 5196.324477817935, 5205.115130427836, 5292.153255479105, 5138.3577052868395, 5147.382314122255, 5152.381714194321, 5169.870753231124, 5179.61152913533, 5142.382914050263, 5158.587313014949, 5168.224766285088, 5176.301199338116, 5210.505002024802, 3941.0, 4017.2969730297664, 4020.2160578686876, 4027.134166154291, 4057.2899742544937, 3570.250247448065, 3614.2229420674157, 3646.9452958205648, 3684.1526448916898, 3686.0, 4890.608751299887, 4910.993246384554, 4927.433345165352, 4932.506749325111, 4958.578520825698, 5013.222950442687, 5226.425093239741, 5233.371995360581, 5253.028189784902, 5287.920681189786, 4712.034033023222, 4739.7630118493935, 4761.595264402565, 4852.272159176152, 4886.511348865085, 4570.497245303014, 4573.268277075652, 4620.2607582786595, 4643.141018911512, 4646.977664913714, 5087.618428617942, 5355.384130825005, 5407.351117865803, 5408.864778380572, 5417.6478528895495, 5105.2086926526445, 5132.897342053213, 5169.870753231199, 5207.088759467002, 5220.451852555427, 5355.30381050461, 5397.190421436816, 5397.190421436816, 5412.052890744183, 5416.539594134385, 4981.6014718823135, 5134.075866344094, 5191.532762051434, 5217.660852044605, 5243.68537887728, 5143.151380022404, 5144.485551444825, 5213.08770965072, 5229.895402092013, 5272.235525848807, 5094.949050509447, 5096.923546146885, 5110.821121260738, 5119.667221630582, 5152.433232344514, 4888.486708895657, 4904.656674032926, 5085.084684756779, 5097.872553186052, 5099.974500127476, 4852.320675105418, 4938.456769755396, 4945.184044632595, 4972.378452693413, 4980.750962451935, 5030.2957585937265, 5044.041632089891, 5080.441151473409, 5103.591712662904, 5136.1268584340005, 4816.036792641416, 4958.504149585013, 5010.323606313101, 5023.196288593807, 5054.69671819692], "mootools.html": [1110.500274876305, 1258.3519487463952, 1485.1683057487808, 1532.8160620725512, 1652.7520871869222, 6170.167027451293, 6404.327545607714, 7118.323759242877, 7404.2965918237815, 7414.925850741491, 7078.292170782919, 7203.567785932848, 7255.1293844738575, 7308.342249197571, 7317.414606831454, 1890.395073576456, 1911.44568075258, 1928.3540014095295, 1931.6136772645457, 1939.3212375668545, 1967.0459826983902, 1969.9901500492479, 1983.5041239690077, 2073.3676228750223, 2075.6056349293663, 1925.124068548814, 1958.3048017953636, 1960.6078784243136, 1975.654260504406, 1976.762788465379, 2008.9196432142696, 2016.5966806638658, 2018.0010894607262, 2025.5138766695961, 2032.349648112612, 1983.990080049605, 1997.650411178038, 2001.3995801259564, 2049.241780541194, 2078.5738923520644, 6436.517261205428, 7184.425245980309, 7249.963750181268, 7270.745523906638, 7288.3804876585555, 3875.2249550090096, 3915.2169566086895, 4222.345536441856, 4269.850555230583, 4314.0, 2415.1426243683413, 2493.887775050127, 2520.6849143857016, 2523.041244327162, 2539.3143851160266, 792.9960350198212, 795.2167115391335, 829.7967946477631, 849.2441726863096, 857.7212405968086, 9465.0, 9576.090271424204, 9579.473128977903, 9626.181774549172, 9721.465319407429, 3717.5167228260693, 3740.5137332146646, 3779.111908701453, 3809.1429428378947, 3826.6364695353896, 7685.846283074307, 7808.06303243603, 7815.6482958267015, 7817.68729250835, 7911.28798408146, 4317.330813723878, 4318.050028993616, 4324.156789426094, 4328.480582330078, 4334.631556317685, 3989.740666856645, 4004.1791432756213, 4007.959920400817, 4015.0765323975647, 4021.6380525752825, 3009.759219262454, 3010.9397812043635, 3043.6956304369387, 3047.2229581456586, 3065.0345141280427, 943.2501161576563, 955.4076472587041, 955.9856602150974, 960.5341409416427, 964.5804075227159, 1068.7007637861411, 1152.982705259422, 1197.5209916033657, 1197.5449329255002, 1197.9041676665845, 6768.323167683192, 6806.55757375769, 6813.795586132324, 6826.0, 6840.726370945106, 1080.3301952789163, 1108.4125413530842, 1132.767782604564, 1138.6242539961793, 1142.7543078238218, 5113.360829896263, 5376.677399356051, 5379.246905433242, 5379.973100134474, 5419.918701219485, 7933.246341597539, 8351.1648835116, 8535.871961920577, 8614.87077693835, 8629.654813807503, 8391.202835730595, 8441.915580844114, 8442.62008209632, 8489.151084891462, 8525.44584601999, 6630.668466576652, 6791.932080679228, 6861.142357205449, 6862.348076932783, 6883.827904302332, 6497.610143391412, 6529.4776417885505, 6542.182227221598, 6603.438707709898, 6612.603243805387, 7678.654460549177, 7735.22647735222, 7770.067591889009, 7843.960780196291, 7848.058233012075, 7828.138904720362, 7962.08436029864, 7976.601169941596, 7979.720709775363, 7980.521168729895, 5805.158252053344, 6020.51835853122, 6368.522360822864, 6387.936120638734, 6400.967995160181, 6852.965735171292, 6879.89680154788, 6912.965435172792, 6931.0643063187845, 6931.965340173267, 6325.873482530232, 6332.810015699536, 6384.148596906845, 6510.804675859732, 6556.377144171487, 6279.654618995999, 6302.779402720883, 6316.873662526816, 6335.239771227482, 6429.58207716497, 6387.137736405712, 6505.381988711065, 6506.056621789909, 6506.837329066622, 6521.217453905561, 5752.482276595127, 5767.279090113736, 5830.679312637845, 5834.124881267844, 5877.059670452707, 5942.0, 5961.463468287875, 6020.729067191899, 6021.698915054318, 6028.306744724413], "ext.html": [497.6789970469048, 503.91937290033604, 507.66240450100685, 510.98059371553757, 525.5952916254487, 27207.727922720765, 28197.718022819765, 34782.8260858696, 35374.0, 35398.2920341593, 36785.448218276746, 37357.0, 37394.626053739456, 37401.43897841528, 37569.0, 7201.3158749918675, 7870.606469676508, 7939.245771651713, 8057.879131812998, 8062.234087761653, 7334.853302933938, 9349.67276145335, 9664.178544823699, 9665.081817227352, 9772.218222542215, 9428.057194280585, 9545.618175273015, 9553.426794392359, 9556.044395560422, 9703.22374210065, 7426.925730742678, 7568.545887246728, 9417.246620270362, 9546.188573971222, 9848.2613803965, 9449.0, 9546.665866694633, 9575.664851730226, 9585.137337639646, 9611.663591774255, 34586.65413345885, 34613.0, 35043.12392190216, 35057.649423505696, 35064.0, 2627.3037645024083, 2730.1127133681634, 2809.6909339972585, 2950.395168990352, 2979.9421205471963, 23660.76339236603, 23717.288481345586, 24210.63684044741, 24288.149914753074, 25051.24846254615, 2043.4176259765895, 2066.8346532277383, 2076.045019291128, 2088.0603728322317, 2151.698762173297, 240519.0, 241322.0, 243892.56107439054, 243916.0, 245036.0, 51434.48565514372, 51762.0, 51817.48182518127, 51931.48068519342, 51969.740151299, 47723.0, 48648.27027594589, 59006.70496647575, 59601.40398596045, 60213.69893150506, 13022.47910083605, 13217.73564528704, 13359.198448093146, 13368.197908125543, 13376.197428154343, 9574.0, 9605.279604029725, 9651.565679544437, 9724.0, 9732.41605503672, 16787.664246714998, 17033.659326813395, 17079.82920170807, 17085.829141708673, 17131.914340428466, 6973.267806880306, 7098.077249957576, 7110.715571377191, 7137.857242855114, 7168.92831071693, 762.771168649403, 828.842519921213, 846.7459762071354, 941.6562954521551, 963.8963386921935, 23839.642405363935, 24234.394140146636, 24320.878395608263, 24427.09166533346, 24729.752702473106, 918.8989211186898, 935.219092058139, 960.9855852162223, 997.7206382212992, 1021.7854250607455, 12691.49234030647, 12858.871411285767, 12885.420156092998, 13139.64938940564, 13738.10702304367, 217853.0, 219751.0, 222097.0, 222335.0, 222653.0, 43469.13061738748, 43728.12543749107, 43735.0, 44292.778536107115, 44307.79690843284, 1220.7680540697238, 1222.8226907098422, 1226.9815952760716, 1228.4103630257525, 1244.3902487780922, 21740.67388989198, 24093.397665058514, 24614.630780537947, 24871.0, 24987.87506062458, 40994.1801163981, 41319.38020929629, 41464.3780343289, 41724.74128880692, 41913.37129942992, 227303.0, 227784.0, 228904.0, 229310.0, 230262.0, 26634.600480993187, 26938.86530567413, 27111.86444067767, 27157.86421067882, 27385.31536711598, 35115.82442087773, 35242.64757352496, 35350.29299414049, 35640.643593563735, 35858.4621230687, 30021.099367019026, 30201.546976794925, 30277.243068923453, 30732.692673072983, 30830.38339233158, 29860.253493662833, 29979.100626981224, 29993.850030749705, 30078.24804379908, 30125.246868827577, 29545.85227073851, 30533.23666908345, 30573.0, 30753.692463075084, 30883.227919302197, 25306.746932531176, 26704.732952670223, 27035.729642704107, 27129.321766955985, 27175.59236611492, 20642.17431302791, 20826.791732082485, 20830.479238018565, 20867.582648347252, 21050.2632407865], "prototype.html": [274.63884991236523, 280.1036682615629, 281.2140068508519, 283.1590177173794, 289.20612917541354, 5385.81149659762, 5456.454354564542, 5483.616146869721, 5487.149491828768, 5512.421195774441, 5299.814506492274, 5371.060064488718, 5408.432114627956, 5410.215518749779, 5429.511343979041, 4237.449131612886, 4241.109367032911, 4254.680898932577, 4270.444842170514, 4293.806778694959, 4120.299549076649, 4185.225733239346, 4190.580941905816, 4191.979040104795, 4291.3777502262155, 4186.895327616819, 4217.283061879488, 4221.598948099941, 4224.915501689964, 4230.936535951963, 4210.894727631803, 4216.936745948813, 4219.1139860629155, 4224.281872081723, 4243.405923170759, 3512.59605145409, 3531.5585551806025, 3545.3441113393847, 3601.8559257629663, 3615.981920090409, 5043.36957880265, 5247.344081989751, 5264.578833693296, 5283.682979021271, 5286.36563612369, 4626.514216007338, 4632.166210082184, 4645.814167433298, 4683.95316046842, 4702.36518070063, 5564.527015203713, 5596.804111856106, 5633.971830140823, 5642.379338272786, 5644.238027866227, 3773.6792372648356, 3847.9230415391817, 3862.4592557042038, 3868.400397938296, 3908.687305015592, 5831.708414579339, 5852.326982397036, 5861.3552509223955, 5883.882322353529, 5937.67342796146, 3915.5888631693833, 3918.74528155669, 3922.980385098056, 3928.7642741435607, 3970.630132604247, 3953.0710283083454, 3964.2269757397607, 3976.0457490202143, 3999.0402303446963, 4006.559278479365, 4556.2937744649635, 4619.2378257587125, 4630.907381852344, 4633.536646335339, 4694.061187762393, 5626.943730562723, 5628.71856407178, 5681.914771278434, 5683.119116536944, 5701.657900525982, 1438.1946110178333, 1455.8471360506994, 1461.4811741831497, 1465.5530063330787, 1469.7281003014477, 941.8728471656376, 950.2825366847985, 958.5734348215117, 964.5466630683568, 970.9174720148867, 5454.645448045864, 5492.533134683516, 5494.066008778517, 5518.227448157261, 5562.0, 5931.288245410492, 5939.554533410012, 5963.105534169822, 5979.222701048923, 5990.101484777231, 5518.19986102021, 5519.420460851553, 5550.500454959073, 5550.8057217997175, 5554.555635549227, 3176.12656519459, 3234.0, 3240.935181296361, 3285.4086264472626, 3285.6221534523356, 6009.248843894513, 6017.849553761103, 6116.235470566179, 6123.693815309306, 6135.601185922901, 6036.215292012011, 6091.8477038073515, 6117.0, 6125.938740612537, 6145.661988590581, 6095.573309868355, 6145.508359331243, 6156.353582873734, 6186.81439556814, 6187.133801267736, 5768.365479797135, 5894.793682221101, 5929.970350148222, 5976.521878249817, 5992.910106348321, 5866.149408335853, 5876.294844618502, 5882.794102206402, 5910.349861515144, 5921.0, 6187.969060154671, 6190.50475961913, 6191.19514463117, 6195.690215489118, 6243.250809902841, 3718.219173973496, 3884.9223015538964, 4063.715539912178, 4070.715049946475, 4084.0606660467665, 5721.427857214412, 5835.79574714883, 5880.676562788916, 5899.793507227227, 5904.350521442724, 5659.292588426447, 5672.602917795714, 5730.598858079894, 5734.770609175586, 5752.108423194411, 5520.751566179451, 5651.745671444713, 5692.886142277214, 5697.401772813795, 5710.457506536873, 5494.395616482264, 5561.805336813192, 5589.832305030855, 5643.943560564506, 5676.091825307931, 5713.600047996601, 5756.136579513107, 5757.424257574209, 5763.596548241583, 5811.0121279381765, 5637.746301416528, 5653.462921022497, 5655.4910058094965, 5660.801871934627, 5690.089585666439], "yui.html": [603.9396060393962, 625.1154616218051, 672.5258692621702, 684.9623270720111, 686.591478070548, 9237.399569028017, 9333.346665733392, 9356.672516461926, 9359.391639543443, 9421.717348479548, 10423.426711530863, 10507.894921050787, 10514.106300964408, 10533.26267161297, 10537.894621053787, 772.4708574626371, 781.3358645151604, 790.3361176611673, 790.5651891459703, 790.8655528560158, 763.1300317637897, 784.051297929506, 784.9058113026445, 792.4809249941297, 793.4961299574783, 823.9546824924627, 824.9546274954876, 826.277007618334, 830.8504469195542, 831.0069466986953, 814.9918500814975, 819.0826274572457, 819.4714409206058, 822.0464261456711, 829.9709510167145, 611.4802417944755, 612.0757655939564, 614.8432149801816, 615.5567991046439, 617.478230894893, 10785.083267922237, 10863.83704244437, 10976.585151266709, 10981.505832237568, 11060.834087488694, 8827.558622068871, 8879.330133035279, 9009.144131307516, 9298.442093474414, 9328.580213890391, 7529.548227106391, 7823.0, 7838.451308408414, 7914.920850791534, 8279.710210142677, 2823.5764635304868, 2833.7591304738917, 2873.094975082842, 2875.051233093095, 2905.8111222770663, 32450.837745811357, 36614.43698941075, 38313.80843095794, 38662.613373866465, 40681.0, 5360.088784906575, 5428.4028756836715, 5573.359063707644, 5578.63738856973, 5665.688387138747, 10151.9492402539, 10184.745381365525, 10263.281570290008, 10323.94838025805, 10331.12185464229, 5044.9495505045215, 5255.684658920477, 5286.603504737083, 5355.0896347621, 5490.56075513958, 3198.6297277380772, 3213.4055199788113, 3230.321632457163, 3336.2993771308297, 3339.231976645385, 2425.478522117753, 2447.0334217984155, 2448.70615526138, 2449.534588428193, 2452.1662634704285, 377.79221428214373, 383.2430948876003, 383.3521348920316, 385.849518687712, 386.74861340129144, 415.84405847807074, 439.68562477828505, 477.90680817241, 479.01323274055557, 489.78204698908644, 6529.510286728514, 6581.243157036906, 6637.701303441357, 6705.2624211336715, 6786.0, 470.40493775374176, 514.2928473349145, 520.5445235419008, 523.3275241314892, 540.9632732761157, 2545.630883521879, 3098.62816462026, 3188.139202415381, 3284.507323901434, 3307.6196237432523, 47402.76298618485, 47792.76103619529, 47982.76008619935, 48143.277850832266, 51340.609236030425, 40923.7953810229, 41074.79462602727, 41277.79361103235, 42234.78882605567, 43952.78023609926, 30317.545236821465, 38621.61378386236, 39207.80396098001, 39223.0, 40659.796701016894, 6637.137172167587, 6645.098802783914, 6846.760363387258, 7175.964120179366, 7236.240194779472, 29693.703062969093, 30083.849580751958, 30444.086677399715, 30911.454427278997, 31095.689043110186, 39263.60736392599, 40098.79950600228, 40450.59549404468, 40548.391774124, 40905.79547102245, 5424.701641409761, 6488.318726533835, 6710.060591517094, 6762.729490820312, 6790.490713196431, 9463.0, 9539.189168920719, 9602.807943841224, 9604.9039509604, 9686.75783105428, 8854.690085846965, 9100.22648074921, 9175.77060573491, 9185.954070229873, 9187.908120918706, 8728.738137855875, 8870.77823054403, 9098.026778723615, 9286.117818807203, 9323.860142097737, 8542.301734046125, 8785.604647790993, 8816.074312197126, 8819.735407937773, 9143.817123657356, 7473.663685134291, 7683.385329173541, 7833.647485863264, 7996.827442621372, 8296.128906464734, 6806.7957961261245, 6964.721411143498, 7018.964905175441, 7174.282571742784, 7265.782026539212]}, "summary": {"lowerIsBetter": false, "suite": 5791.847179688286, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 5720.042290064515, "unit": "ms", "value": 5720.042290064515}, "dojo.html": {"lowerIsBetter": false, "filtered": 4806.169415022166, "unit": "ms", "value": 4806.169415022166}, "mootools.html": {"lowerIsBetter": false, "filtered": 4040.949826957954, "unit": "ms", "value": 4040.949826957954}, "ext.html": {"lowerIsBetter": false, "filtered": 15954.683052442195, "unit": "ms", "value": 15954.683052442195}, "prototype.html": {"lowerIsBetter": false, "filtered": 4304.496290378593, "unit": "ms", "value": 4304.496290378593}, "yui.html": {"lowerIsBetter": false, "filtered": 4947.326017175224, "unit": "ms", "value": 4947.326017175224}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0093"}, "testrun": {"date": 1447148031, "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": "20151110000603", "branch": "Mozilla-Inbound", "revision": "180b1c201aa2ec9277207d76341c9b60254c80b4"}}, {"talos_counters": {}, "results": {"audio-dft": [179.0, 179.0, 189.0, 183.0, 179.0, 181.0, 181.0, 190.0, 186.0, 181.0], "ai-astar": [120.0, 115.0, 128.0, 126.0, 120.0, 119.0, 127.0, 127.0, 127.0, 120.0], "imaging-gaussian-blur": [131.0, 136.0, 134.0, 130.0, 130.0, 135.0, 131.0, 129.0, 129.0, 142.0], "audio-beat-detection": [178.0, 151.0, 172.0, 185.0, 143.0, 173.0, 170.0, 146.0, 182.0, 142.0], "json-stringify-tinderbox": [73.0, 74.0, 74.0, 77.0, 78.0, 83.0, 79.0, 77.0, 75.0, 76.0], "stanford-crypto-pbkdf2": [174.0, 173.0, 180.0, 172.0, 183.0, 163.0, 175.0, 182.0, 185.0, 174.0], "json-parse-financial": [61.0, 65.0, 65.0, 65.0, 67.0, 67.0, 68.0, 75.0, 62.0, 64.0], "stanford-crypto-sha256-iterative": [80.0, 84.0, 85.0, 86.0, 85.0, 81.0, 83.0, 82.0, 82.0, 82.0], "audio-fft": [78.0, 93.0, 94.0, 138.0, 78.0, 80.0, 80.0, 77.0, 125.0, 75.0], "imaging-darkroom": [141.0, 148.0, 144.0, 141.0, 142.0, 148.0, 143.0, 141.0, 141.0, 147.0], "stanford-crypto-ccm": [151.0, 147.0, 152.0, 144.0, 150.0, 144.0, 137.0, 143.0, 149.0, 144.0], "audio-oscillator": [110.0, 113.0, 158.0, 103.0, 103.0, 103.0, 142.0, 98.0, 104.0, 151.0], "stanford-crypto-aes": [97.0, 100.0, 100.0, 100.0, 97.0, 96.0, 96.0, 101.0, 105.0, 101.0], "imaging-desaturate": [118.0, 118.0, 114.0, 113.0, 119.0, 117.0, 116.0, 115.0, 118.0, 120.0]}, "summary": {"lowerIsBetter": true, "suite": 1720.3, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 91.8, "unit": "ms", "value": 91.8}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 176.1, "unit": "ms", "value": 176.1}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 164.2, "unit": "ms", "value": 164.2}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 146.1, "unit": "ms", "value": 146.1}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 143.6, "unit": "ms", "value": 143.6}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 65.9, "unit": "ms", "value": 65.9}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 118.5, "unit": "ms", "value": 118.5}, "ai-astar": {"lowerIsBetter": true, "filtered": 122.9, "unit": "ms", "value": 122.9}, "audio-dft": {"lowerIsBetter": true, "filtered": 182.8, "unit": "ms", "value": 182.8}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 83.0, "unit": "ms", "value": 83.0}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 76.6, "unit": "ms", "value": 76.6}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 132.7, "unit": "ms", "value": 132.7}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 99.3, "unit": "ms", "value": 99.3}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 116.8, "unit": "ms", "value": 116.8}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0093"}, "testrun": {"date": 1447148031, "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": "20151110000603", "branch": "Mozilla-Inbound", "revision": "180b1c201aa2ec9277207d76341c9b60254c80b4"}}, {"talos_counters": {}, "results": {"DeltaBlue": [216.3097555699762], "Encrypt": [363.10820624546113], "NavierStokes": [6410.25641025641], "Decrypt": [6451.612903225807], "Splay": [1006.993006993007], "Richards": [188.57250612860645], "RegExp": [32661.290322580644], "Earley": [1014.1987829614604], "Boyer": [13972.222222222223], "RayTrace": [2131.9148936170213]}, "summary": {"lowerIsBetter": false, "suite": 15899.639535340244, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 305.66351399999996, "unit": "score", "value": 305.66351399999996}, "Encrypt": {"lowerIsBetter": false, "filtered": 733.0624740000002, "unit": "score", "value": 733.0624740000002}, "NavierStokes": {"lowerIsBetter": false, "filtered": 231.5039999999999, "unit": "score", "value": 231.5039999999999}, "Decrypt": {"lowerIsBetter": false, "filtered": 41.258055000000006, "unit": "score", "value": 41.258055000000006}, "Splay": {"lowerIsBetter": false, "filtered": 80.92509027777776, "unit": "score", "value": 80.92509027777776}, "RegExp": {"lowerIsBetter": false, "filtered": 27.891886419753106, "unit": "score", "value": 27.891886419753106}, "Richards": {"lowerIsBetter": false, "filtered": 187.20650599999996, "unit": "score", "value": 187.20650599999996}, "Earley": {"lowerIsBetter": false, "filtered": 657.1325180000003, "unit": "score", "value": 657.1325180000003}, "Boyer": {"lowerIsBetter": false, "filtered": 47.69914115308153, "unit": "score", "value": 47.69914115308153}, "RayTrace": {"lowerIsBetter": false, "filtered": 347.10062874251497, "unit": "score", "value": 347.10062874251497}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0093"}, "testrun": {"date": 1447148031, "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": "20151110000603", "branch": "Mozilla-Inbound", "revision": "180b1c201aa2ec9277207d76341c9b60254c80b4"}}] 01:54:07 INFO - RETURN: dromaeo_css: 5791.85 01:54:07 INFO - RETURN: kraken: 1720.30 01:54:07 INFO - RETURN: v8_7: 15899.64 01:54:07 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,63,55]]", "result": "15899.64"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,63,55]]", "result": "1720.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,63,55]]", "result": "5791.85"}}} 01:54:07 INFO - Return code: 0 01:54:07 INFO - # TBPL SUCCESS # 01:54:07 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 01:54:07 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 01:54:07 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 01:54:07 INFO - 2015-11-10 01:54:07.994 screenresolution[2289:13491] starting screenresolution argv=screenresolution get 01:54:08 INFO - 2015-11-10 01:54:08.000 screenresolution[2289:13491] Display 0: 1600x1200x32@60 01:54:08 INFO - 2015-11-10 01:54:08.007 screenresolution[2290:13494] starting screenresolution argv=screenresolution list 01:54:08 INFO - Available Modes on Display 0 01:54:08 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 01:54:08 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 01:54:08 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 01:54:08 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 01:54:08 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 01:54:08 INFO - Intel HD Graphics 3000: 01:54:08 INFO - Chipset Model: Intel HD Graphics 3000 01:54:08 INFO - Type: GPU 01:54:08 INFO - Bus: Built-In 01:54:08 INFO - VRAM (Total): 512 MB 01:54:08 INFO - VRAM (Dynamic, Max): 10 01:54:08 INFO - Vendor: Intel (0x8086) 01:54:08 INFO - Device ID: 0x0116 01:54:08 INFO - Revision ID: 0x0009 01:54:08 INFO - Displays: 01:54:08 INFO - Display: 01:54:08 INFO - Resolution: 1600 x 1200 @ 60 Hz 01:54:08 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 01:54:08 INFO - Display Serial Number: 1600x1200 60 01:54:08 INFO - Main Display: Yes 01:54:08 INFO - Mirror: Off 01:54:08 INFO - Online: Yes 01:54:08 INFO - Rotation: Supported 01:54:08 INFO - Return code: 0 01:54:08 INFO - Running post-action listener: _resource_record_post_action 01:54:08 INFO - Running post-run listener: _resource_record_post_run 01:54:09 INFO - Total resource usage - Wall time: 1257s; CPU: 30.0%; Read bytes: 1814528; Write bytes: 682829824; Read time: 736; Write time: 52462 01:54:09 INFO - install - Wall time: 40s; CPU: 30.0%; Read bytes: 334209536; Write bytes: 333563904; Read time: 34258; Write time: 5430 01:54:09 INFO - run-tests - Wall time: 1217s; CPU: 30.0%; Read bytes: 1814528; Write bytes: 338907136; Read time: 736; Write time: 45936 01:54:09 INFO - Running post-run listener: _upload_blobber_files 01:54:09 INFO - Blob upload gear active. 01:54:09 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 01:54:09 INFO - Copying logs to upload dir... 01:54:09 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1320.699079 ========= master_lag: 0.47 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 1 secs) (at 2015-11-10 01:54:09.872471) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-10 01:54:09.875775) ========= 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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners TMPDIR=/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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/YmeIiQZRQP6V3LgjS9YlPg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010380 build_url: 'https://queue.taskcluster.net/v1/task/YmeIiQZRQP6V3LgjS9YlPg/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-10 01:54:09.908401) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-10 01:54:09.908805) ========= 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.3xhO3nTEEq/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.Iqai9CkTJV/Listeners TMPDIR=/var/folders/pp/yw56l8613m3brdjhlbddfxx400000w/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.005095 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-10 01:54:09.958791) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-10 01:54:09.959206) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-10 01:54:09.959716) ========= ========= Total master_lag: 0.73 =========