builder: mozilla-aurora_yosemite_test-dromaeojs slave: t-yosemite-r5-0006 starttime: 1449240453.84 results: success (0) buildid: 20151203200703 builduid: e10b456502284880814434de3fd7511b revision: 858b1b930b16a5c46634e3dad2650c517e150cb0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.836100) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.836537) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.836819) ========= 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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners TMPDIR=/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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.005758 basedir: '/builds/slave/test' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.854662) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.854959) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.898823) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.899234) ========= 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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners TMPDIR=/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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.005723 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.947932) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.948243) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.948602) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:33.948873) ========= 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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners TMPDIR=/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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-12-04 06:47:33-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 1.41G=0s 2015-12-04 06:47:34 (1.41 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.122031 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.081529) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.081886) ========= 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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners TMPDIR=/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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.020688 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.130908) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.131273) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 858b1b930b16a5c46634e3dad2650c517e150cb0 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 858b1b930b16a5c46634e3dad2650c517e150cb0 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.gQevzpIaHP/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.ZYhf7q6tDT/Listeners TMPDIR=/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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-12-04 06:47:34,214 truncating revision to first 12 chars 2015-12-04 06:47:34,214 Setting DEBUG logging. 2015-12-04 06:47:34,214 attempt 1/10 2015-12-04 06:47:34,214 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/858b1b930b16?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-04 06:47:34,644 unpacking tar archive at: mozilla-aurora-858b1b930b16/testing/mozharness/ program finished with exit code 0 elapsedTime=0.840504 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.983381) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.983702) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.991743) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.992011) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-04 06:47:34.992400) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 49 secs) (at 2015-12-04 06:47:34.992680) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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-Aurora', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.gQevzpIaHP/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.ZYhf7q6tDT/Listeners TMPDIR=/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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 06:47:35 INFO - MultiFileLogger online at 20151204 06:47:35 in /builds/slave/test 06:47:35 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 06:47:35 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:47:35 INFO - {'append_to_log': False, 06:47:35 INFO - 'base_work_dir': '/builds/slave/test', 06:47:35 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 06:47:35 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:47:35 INFO - 'branch': 'Mozilla-Aurora', 06:47:35 INFO - 'buildbot_json_path': 'buildprops.json', 06:47:35 INFO - 'config_files': ('talos/mac_config.py',), 06:47:35 INFO - 'default_actions': ('clobber', 06:47:35 INFO - 'read-buildbot-config', 06:47:35 INFO - 'download-and-extract', 06:47:35 INFO - 'populate-webroot', 06:47:35 INFO - 'create-virtualenv', 06:47:35 INFO - 'install', 06:47:35 INFO - 'run-tests'), 06:47:35 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:47:35 INFO - 'download_minidump_stackwalk': True, 06:47:35 INFO - 'download_symbols': 'ondemand', 06:47:35 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:47:35 INFO - 'tooltool.py': '/tools/tooltool.py', 06:47:35 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:47:35 INFO - '/tools/misc-python/virtualenv.py')}, 06:47:35 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:47:35 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:47:35 INFO - 'installer_path': 'installer.exe', 06:47:35 INFO - 'log_level': 'info', 06:47:35 INFO - 'log_name': 'talos', 06:47:35 INFO - 'log_to_console': True, 06:47:35 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 06:47:35 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 06:47:35 INFO - 'opt_config_files': (), 06:47:35 INFO - 'pip_index': False, 06:47:35 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 06:47:35 INFO - 'cmd': ('bash', 06:47:35 INFO - '-c', 06:47:35 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 06:47:35 INFO - 'enabled': True, 06:47:35 INFO - 'halt_on_failure': False, 06:47:35 INFO - 'name': 'check_screen_resolution'},), 06:47:35 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 06:47:35 INFO - 'cmd': ('bash', 06:47:35 INFO - '-c', 06:47:35 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 06:47:35 INFO - 'enabled': True, 06:47:35 INFO - 'halt_on_failure': False, 06:47:35 INFO - 'name': 'check_screen_resolution'},), 06:47:35 INFO - 'run_cmd_checks_enabled': True, 06:47:35 INFO - 'sps_profile': False, 06:47:35 INFO - 'sps_profile_interval': 0, 06:47:35 INFO - 'suite': 'dromaeojs', 06:47:35 INFO - 'system_bits': '64', 06:47:35 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:47:35 INFO - 'title': 't-yosemite-r5-0006', 06:47:35 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:47:35 INFO - 'use_talos_json': True, 06:47:35 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:47:35 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:47:35 INFO - 'work_dir': 'build'} 06:47:35 INFO - ##### 06:47:35 INFO - ##### Running clobber step. 06:47:35 INFO - ##### 06:47:35 INFO - Running pre-action listener: _resource_record_pre_action 06:47:35 INFO - Running main action method: clobber 06:47:35 INFO - rmtree: /builds/slave/test/build 06:47:35 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:47:36 INFO - Running post-action listener: _resource_record_post_action 06:47:36 INFO - ##### 06:47:36 INFO - ##### Running read-buildbot-config step. 06:47:36 INFO - ##### 06:47:36 INFO - Running pre-action listener: _resource_record_pre_action 06:47:36 INFO - Running main action method: read_buildbot_config 06:47:36 INFO - Using buildbot properties: 06:47:36 INFO - { 06:47:36 INFO - "properties": { 06:47:36 INFO - "buildnumber": 298, 06:47:36 INFO - "product": "firefox", 06:47:36 INFO - "script_repo_revision": "production", 06:47:36 INFO - "builddir": "mozilla-aurora_yosemite_test-dromaeojs", 06:47:36 INFO - "repository": "", 06:47:36 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 mozilla-aurora talos dromaeojs", 06:47:36 INFO - "buildid": "20151203200703", 06:47:36 INFO - "slavename": "t-yosemite-r5-0006", 06:47:36 INFO - "pgo_build": "False", 06:47:36 INFO - "basedir": "/builds/slave/test", 06:47:36 INFO - "project": "", 06:47:36 INFO - "platform": "yosemite", 06:47:36 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 06:47:36 INFO - "slavebuilddir": "test", 06:47:36 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 06:47:36 INFO - "branch": "mozilla-aurora", 06:47:36 INFO - "repo_path": "releases/mozilla-aurora", 06:47:36 INFO - "stage_platform": "macosx64", 06:47:36 INFO - "builduid": "e10b456502284880814434de3fd7511b", 06:47:36 INFO - "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0" 06:47:36 INFO - }, 06:47:36 INFO - "sourcestamp": { 06:47:36 INFO - "repository": "", 06:47:36 INFO - "hasPatch": false, 06:47:36 INFO - "project": "", 06:47:36 INFO - "branch": "mozilla-aurora-macosx64-talos", 06:47:36 INFO - "changes": [ 06:47:36 INFO - { 06:47:36 INFO - "category": null, 06:47:36 INFO - "files": [ 06:47:36 INFO - { 06:47:36 INFO - "url": null, 06:47:36 INFO - "name": "https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg" 06:47:36 INFO - } 06:47:36 INFO - ], 06:47:36 INFO - "repository": "", 06:47:36 INFO - "rev": "858b1b930b16a5c46634e3dad2650c517e150cb0", 06:47:36 INFO - "who": "maglione.k@gmail.com", 06:47:36 INFO - "when": 1449208311, 06:47:36 INFO - "number": 6743158, 06:47:36 INFO - "comments": "Bug 1218443: [webext] Fix some instances of window listeners not being added correctly. r=billm a=ritu", 06:47:36 INFO - "project": "", 06:47:36 INFO - "at": "Thu 03 Dec 2015 21:51:51", 06:47:36 INFO - "branch": "mozilla-aurora-macosx64-talos", 06:47:36 INFO - "revlink": "", 06:47:36 INFO - "properties": [ 06:47:36 INFO - [ 06:47:36 INFO - "buildid", 06:47:36 INFO - "20151203200703", 06:47:36 INFO - "Change" 06:47:36 INFO - ], 06:47:36 INFO - [ 06:47:36 INFO - "builduid", 06:47:36 INFO - "e10b456502284880814434de3fd7511b", 06:47:36 INFO - "Change" 06:47:36 INFO - ], 06:47:36 INFO - [ 06:47:36 INFO - "pgo_build", 06:47:36 INFO - "False", 06:47:36 INFO - "Change" 06:47:36 INFO - ] 06:47:36 INFO - ], 06:47:36 INFO - "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0" 06:47:36 INFO - } 06:47:36 INFO - ], 06:47:36 INFO - "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0" 06:47:36 INFO - } 06:47:36 INFO - } 06:47:36 INFO - Found installer url https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg. 06:47:36 INFO - Running post-action listener: _resource_record_post_action 06:47:36 INFO - ##### 06:47:36 INFO - ##### Running download-and-extract step. 06:47:36 INFO - ##### 06:47:36 INFO - Running pre-action listener: _resource_record_pre_action 06:47:36 INFO - Running main action method: download_and_extract 06:47:36 INFO - mkdir: /builds/slave/test/build/tests 06:47: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')]} 06:47:36 INFO - https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 06:47:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/test_packages.json 06:47:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/test_packages.json 06:47:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 06:47:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 06:47:37 INFO - Downloaded 1149 bytes. 06:47:37 INFO - Reading from file /builds/slave/test/build/test_packages.json 06:47:37 INFO - Using the following test package requirements: 06:47:37 INFO - {u'common': [u'firefox-44.0a2.en-US.mac.common.tests.zip'], 06:47:37 INFO - u'cppunittest': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 06:47:37 INFO - u'firefox-44.0a2.en-US.mac.cppunittest.tests.zip'], 06:47:37 INFO - u'jittest': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 06:47:37 INFO - u'jsshell-mac.zip'], 06:47:37 INFO - u'mochitest': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 06:47:37 INFO - u'firefox-44.0a2.en-US.mac.mochitest.tests.zip'], 06:47:37 INFO - u'mozbase': [u'firefox-44.0a2.en-US.mac.common.tests.zip'], 06:47:37 INFO - u'reftest': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 06:47:37 INFO - u'firefox-44.0a2.en-US.mac.reftest.tests.zip'], 06:47:37 INFO - u'talos': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 06:47:37 INFO - u'firefox-44.0a2.en-US.mac.talos.tests.zip'], 06:47:37 INFO - u'web-platform': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 06:47:37 INFO - u'firefox-44.0a2.en-US.mac.web-platform.tests.zip'], 06:47:37 INFO - u'webapprt': [u'firefox-44.0a2.en-US.mac.common.tests.zip'], 06:47:37 INFO - u'xpcshell': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 06:47:37 INFO - u'firefox-44.0a2.en-US.mac.xpcshell.tests.zip']} 06:47:37 INFO - Downloading packages: [u'firefox-44.0a2.en-US.mac.common.tests.zip'] for test suite category: common 06:47: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')]} 06:47:37 INFO - https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 06:47:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip 06:47:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip 06:47:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip 06:47:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'}, attempt #1 06:47:38 INFO - Downloaded 17490132 bytes. 06:47:38 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 06:47:38 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip 06:47:38 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'] with output_timeout 1760 06:47:47 INFO - Return code: 0 06:47:47 INFO - Downloading packages: [u'firefox-44.0a2.en-US.mac.common.tests.zip', u'firefox-44.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 06:47:47 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')]} 06:47:47 INFO - https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 06:47:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip 06:47:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip 06:47:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip 06:47:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'}, attempt #1 06:47:48 INFO - Downloaded 17490132 bytes. 06:47:48 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 06:47:48 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip 06:47:48 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'] with output_timeout 1760 06:47:56 INFO - Return code: 0 06:47:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:47:56 INFO - https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 06:47:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip 06:47:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip 06:47:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip 06:47:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip'}, attempt #1 06:47:58 INFO - Downloaded 11131307 bytes. 06:47:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 06:47:58 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip 06:47:58 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip'] with output_timeout 1760 06:47:58 INFO - Return code: 0 06:47: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')]} 06:47:58 INFO - https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg matches https://queue.taskcluster.net 06:47:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg 06:47:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg 06:47:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-44.0a2.en-US.mac.dmg 06:47:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-44.0a2.en-US.mac.dmg'}, attempt #1 06:48:01 INFO - Downloaded 108689100 bytes. 06:48:01 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg 06:48:01 INFO - mkdir: /builds/slave/test/properties 06:48:01 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:48:01 INFO - Writing to file /builds/slave/test/properties/build_url 06:48:01 INFO - Contents: 06:48:01 INFO - build_url:https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg 06:48:01 INFO - Running post-action listener: _resource_record_post_action 06:48:01 INFO - Running post-action listener: set_extra_try_arguments 06:48:01 INFO - ##### 06:48:01 INFO - ##### Running populate-webroot step. 06:48:01 INFO - ##### 06:48:01 INFO - Running pre-action listener: _resource_record_pre_action 06:48:01 INFO - Running main action method: populate_webroot 06:48:01 INFO - Guessing talos json url... 06:48:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:01 INFO - https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.txt matches https://queue.taskcluster.net 06:48:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.txt 06:48:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.txt 06:48:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.txt to /builds/slave/test/build/firefox-44.0a2.en-US.mac.txt 06:48:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.txt', 'file_name': '/builds/slave/test/build/firefox-44.0a2.en-US.mac.txt'}, attempt #1 06:48:02 INFO - Downloaded 107 bytes. 06:48:02 INFO - Reading from file /builds/slave/test/build/firefox-44.0a2.en-US.mac.txt 06:48:02 INFO - Contents: 06:48:02 INFO - 20151203200703 06:48:02 INFO - https://hg.mozilla.org/releases/mozilla-aurora/rev/858b1b930b16a5c46634e3dad2650c517e150cb0 06:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:02 INFO - trying https://hg.mozilla.org/releases/mozilla-aurora/raw-file/858b1b930b/testing/talos/talos.json 06:48:02 INFO - Downloading https://hg.mozilla.org/releases/mozilla-aurora/raw-file/858b1b930b/testing/talos/talos.json to /builds/slave/test/build/talos.json 06:48:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/releases/mozilla-aurora/raw-file/858b1b930b/testing/talos/talos.json', 'file_name': '/builds/slave/test/build/talos.json'}, attempt #1 06:48:03 INFO - Downloaded 4264 bytes. 06:48:03 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:48:03 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:48:03 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 06:48:03 INFO - '../fennec_ids.txt'], 06:48:03 INFO - 'tests': ['tcheck2']}, 06:48:03 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:48:03 INFO - '--tppagecycles', 06:48:03 INFO - '7'], 06:48:03 INFO - 'tests': ['tsvgm']}}, 06:48:03 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 06:48:03 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:48:03 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 06:48:03 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 06:48:03 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:48:03 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:03 INFO - 'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:48:03 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:03 INFO - 'tests': ['damp', 'tps']}, 06:48:03 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:03 INFO - 'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['damp', 'tps']}, 06:48:03 INFO - 'g3': {'tests': ['dromaeo_dom']}, 06:48:03 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:48:03 INFO - 'other': {'tests': ['a11yr', 06:48:03 INFO - 'ts_paint', 06:48:03 INFO - 'tpaint', 06:48:03 INFO - 'sessionrestore', 06:48:03 INFO - 'sessionrestore_no_auto_restore']}, 06:48:03 INFO - 'other-e10s': {'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['a11yr', 06:48:03 INFO - 'ts_paint', 06:48:03 INFO - 'tpaint', 06:48:03 INFO - 'sessionrestore', 06:48:03 INFO - 'sessionrestore_no_auto_restore']}, 06:48:03 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['a11yr', 06:48:03 INFO - 'ts_paint', 06:48:03 INFO - 'tpaint', 06:48:03 INFO - 'sessionrestore', 06:48:03 INFO - 'sessionrestore_no_auto_restore']}, 06:48:03 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['a11yr', 06:48:03 INFO - 'ts_paint', 06:48:03 INFO - 'tpaint', 06:48:03 INFO - 'sessionrestore', 06:48:03 INFO - 'sessionrestore_no_auto_restore']}, 06:48:03 INFO - 'other_l64': {'tests': ['a11yr', 06:48:03 INFO - 'ts_paint', 06:48:03 INFO - 'tpaint', 06:48:03 INFO - 'sessionrestore', 06:48:03 INFO - 'sessionrestore_no_auto_restore']}, 06:48:03 INFO - 'other_nol64': {'tests': ['a11yr', 06:48:03 INFO - 'ts_paint', 06:48:03 INFO - 'tpaint', 06:48:03 INFO - 'sessionrestore', 06:48:03 INFO - 'sessionrestore_no_auto_restore']}, 06:48:03 INFO - 'svgr': {'tests': ['tsvgx', 06:48:03 INFO - 'tsvgr_opacity', 06:48:03 INFO - 'tart', 06:48:03 INFO - 'tscrollx', 06:48:03 INFO - 'cart']}, 06:48:03 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['tsvgx', 06:48:03 INFO - 'tsvgr_opacity', 06:48:03 INFO - 'tart', 06:48:03 INFO - 'tscrollx', 06:48:03 INFO - 'cart']}, 06:48:03 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:03 INFO - 'tests': ['tp5o']}, 06:48:03 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:03 INFO - 'talos_options': ['--e10s'], 06:48:03 INFO - 'tests': ['tp5o']}, 06:48:03 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:03 INFO - 'talos_options': ['--xperf_path', 06:48:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:48:03 INFO - 'tests': ['tp5n']}, 06:48:03 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:03 INFO - 'talos_options': ['--e10s', 06:48:03 INFO - '--xperf_path', 06:48:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 06:48:03 INFO - 'C:/slave/talos-data/talos/xperf.config'], 06:48:03 INFO - 'tests': ['tp5n']}}, 06:48:03 INFO - 'talos.zip': {'path': '', 06:48:03 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:48:03 INFO - Running post-action listener: _resource_record_post_action 06:48:03 INFO - ##### 06:48:03 INFO - ##### Running create-virtualenv step. 06:48:03 INFO - ##### 06:48:03 INFO - Running pre-action listener: _resource_record_pre_action 06:48:03 INFO - Running main action method: create_virtualenv 06:48:03 INFO - Creating virtualenv /builds/slave/test/build/venv 06:48:03 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 06:48:03 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:48:03 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:48:03 INFO - Using real prefix '/tools/python27' 06:48:03 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:48:04 INFO - Installing distribute.............................................................................................................................................................................................done. 06:48:08 INFO - Installing pip.................done. 06:48:08 INFO - Return code: 0 06:48:08 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:48:08 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')]} 06:48:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:08 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')]} 06:48:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:08 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 0x110417a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110484228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94e1562a90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1103cc9f0>, '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 0x11012bcd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x110396990>, '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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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 06:48:08 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 06:48:08 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 06:48:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gQevzpIaHP/Render', 06:48:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:48:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:48:08 INFO - 'HOME': '/Users/cltbld', 06:48:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:48:08 INFO - 'LOGNAME': 'cltbld', 06:48:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:08 INFO - 'MOZ_NO_REMOTE': '1', 06:48:08 INFO - 'NO_EM_RESTART': '1', 06:48:08 INFO - 'PAGER': '/bin/cat', 06:48:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:48:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:08 INFO - 'PWD': '/builds/slave/test', 06:48:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:48:08 INFO - 'SHELL': '/bin/bash', 06:48:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ZYhf7q6tDT/Listeners', 06:48:08 INFO - 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/', 06:48:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:48:08 INFO - 'USER': 'cltbld', 06:48:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:48:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:48:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:08 INFO - 'XPC_FLAGS': '0x0', 06:48:08 INFO - 'XPC_SERVICE_NAME': '0', 06:48:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 06:48:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:08 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 06:48:08 INFO - Cleaning up... 06:48:08 INFO - Return code: 0 06:48:08 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 06:48:08 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')]} 06:48:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:08 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')]} 06:48:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:08 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 0x110417a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110484228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94e1562a90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1103cc9f0>, '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 0x11012bcd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x110396990>, '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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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 06:48:08 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 06:48:08 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 06:48:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gQevzpIaHP/Render', 06:48:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:48:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:48:08 INFO - 'HOME': '/Users/cltbld', 06:48:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:48:08 INFO - 'LOGNAME': 'cltbld', 06:48:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:08 INFO - 'MOZ_NO_REMOTE': '1', 06:48:08 INFO - 'NO_EM_RESTART': '1', 06:48:08 INFO - 'PAGER': '/bin/cat', 06:48:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:48:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:08 INFO - 'PWD': '/builds/slave/test', 06:48:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:48:08 INFO - 'SHELL': '/bin/bash', 06:48:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ZYhf7q6tDT/Listeners', 06:48:08 INFO - 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/', 06:48:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:48:08 INFO - 'USER': 'cltbld', 06:48:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:48:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:48:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:08 INFO - 'XPC_FLAGS': '0x0', 06:48:08 INFO - 'XPC_SERVICE_NAME': '0', 06:48:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 06:48:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:08 INFO - Downloading/unpacking psutil>=0.7.1 06:48:08 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 06:48:08 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 06:48:08 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 06:48:08 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 06:48:08 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 06:48:08 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 06:48:11 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 06:48:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 06:48:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:48:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:48:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:48:11 INFO - Installing collected packages: psutil 06:48:11 INFO - Running setup.py install for psutil 06:48:11 INFO - building 'psutil._psutil_osx' extension 06:48:11 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 06:48:13 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 06:48:13 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 06:48:13 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 06:48:13 INFO - building 'psutil._psutil_posix' extension 06:48:13 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 06:48:13 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 06:48:13 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 06:48:13 INFO - ^ 06:48:13 INFO - 1 warning generated. 06:48:13 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 06:48:13 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:48:13 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:48:13 INFO - Successfully installed psutil 06:48:13 INFO - Cleaning up... 06:48:13 INFO - Return code: 0 06:48:13 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 06:48:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x110417a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110484228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94e1562a90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1103cc9f0>, '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 0x11012bcd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x110396990>, '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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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 06:48:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 06:48:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 06:48:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gQevzpIaHP/Render', 06:48:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:48:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:48:13 INFO - 'HOME': '/Users/cltbld', 06:48:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:48:13 INFO - 'LOGNAME': 'cltbld', 06:48:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:13 INFO - 'MOZ_NO_REMOTE': '1', 06:48:13 INFO - 'NO_EM_RESTART': '1', 06:48:13 INFO - 'PAGER': '/bin/cat', 06:48:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:48:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:13 INFO - 'PWD': '/builds/slave/test', 06:48:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:48:13 INFO - 'SHELL': '/bin/bash', 06:48:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ZYhf7q6tDT/Listeners', 06:48:13 INFO - 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/', 06:48:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:48:13 INFO - 'USER': 'cltbld', 06:48:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:48:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:48:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:13 INFO - 'XPC_FLAGS': '0x0', 06:48:13 INFO - 'XPC_SERVICE_NAME': '0', 06:48:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 06:48:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:13 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 06:48:13 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 06:48:13 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 06:48:13 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 06:48:13 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 06:48:13 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 06:48:13 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 06:48:16 INFO - Downloading mozsystemmonitor-0.0.tar.gz 06:48:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 06:48:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 06:48:16 INFO - Installing collected packages: mozsystemmonitor 06:48:16 INFO - Running setup.py install for mozsystemmonitor 06:48:16 INFO - Successfully installed mozsystemmonitor 06:48:16 INFO - Cleaning up... 06:48:16 INFO - Return code: 0 06:48:16 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:48:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x110417a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110484228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94e1562a90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1103cc9f0>, '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 0x11012bcd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x110396990>, '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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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 06:48:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 06:48:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 06:48:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gQevzpIaHP/Render', 06:48:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:48:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:48:16 INFO - 'HOME': '/Users/cltbld', 06:48:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:48:16 INFO - 'LOGNAME': 'cltbld', 06:48:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:16 INFO - 'MOZ_NO_REMOTE': '1', 06:48:16 INFO - 'NO_EM_RESTART': '1', 06:48:16 INFO - 'PAGER': '/bin/cat', 06:48:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:48:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:16 INFO - 'PWD': '/builds/slave/test', 06:48:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:48:16 INFO - 'SHELL': '/bin/bash', 06:48:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ZYhf7q6tDT/Listeners', 06:48:16 INFO - 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/', 06:48:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:48:16 INFO - 'USER': 'cltbld', 06:48:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:48:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:48:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:16 INFO - 'XPC_FLAGS': '0x0', 06:48:16 INFO - 'XPC_SERVICE_NAME': '0', 06:48:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 06:48:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:16 INFO - Downloading/unpacking blobuploader==1.2.4 06:48:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:19 INFO - Downloading blobuploader-1.2.4.tar.gz 06:48:19 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 06:48:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:48:19 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:48:19 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 06:48:19 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 06:48:19 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 06:48:19 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 06:48:19 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 06:48:19 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 06:48:19 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 06:48:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:48:19 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:48:19 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 06:48:19 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 06:48:19 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 06:48:19 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 06:48:19 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 06:48:19 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 06:48:20 INFO - Downloading docopt-0.6.1.tar.gz 06:48:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 06:48:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:48:20 INFO - Installing collected packages: blobuploader, requests, docopt 06:48:20 INFO - Running setup.py install for blobuploader 06:48:20 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:48:20 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:48:20 INFO - Running setup.py install for requests 06:48:21 INFO - Running setup.py install for docopt 06:48:21 INFO - Successfully installed blobuploader requests docopt 06:48:21 INFO - Cleaning up... 06:48:21 INFO - Return code: 0 06:48:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:48:21 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')]} 06:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:21 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')]} 06:48:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:21 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 0x110417a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110484228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94e1562a90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1103cc9f0>, '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 0x11012bcd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x110396990>, '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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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 06:48:21 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 06:48:21 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 06:48:21 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gQevzpIaHP/Render', 06:48:21 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:48:21 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:48:21 INFO - 'HOME': '/Users/cltbld', 06:48:21 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:48:21 INFO - 'LOGNAME': 'cltbld', 06:48:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:21 INFO - 'MOZ_NO_REMOTE': '1', 06:48:21 INFO - 'NO_EM_RESTART': '1', 06:48:21 INFO - 'PAGER': '/bin/cat', 06:48:21 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:48:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:21 INFO - 'PWD': '/builds/slave/test', 06:48:21 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:48:21 INFO - 'SHELL': '/bin/bash', 06:48:21 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ZYhf7q6tDT/Listeners', 06:48:21 INFO - 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/', 06:48:21 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:48:21 INFO - 'USER': 'cltbld', 06:48:21 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:48:21 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:48:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:21 INFO - 'XPC_FLAGS': '0x0', 06:48:21 INFO - 'XPC_SERVICE_NAME': '0', 06:48:21 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 06:48:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:48:21 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-J91LlW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:48:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:48:21 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-sJ9NsZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-PovoQR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-E_PJS6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-0XRPCn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-3PLije-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-tP8MLJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-SDHGbC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-R2ZwZW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-K8kz1c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:48:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:48:22 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-TQeCHh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:48:23 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-4Rhk1t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:48:23 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-zf7f6y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:48:23 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-_OwF4r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:48:23 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-n91Mrb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:48:23 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-Dh4p83-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:48:23 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-hBTsL9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:48:23 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:48:23 INFO - Running setup.py install for manifestparser 06:48:23 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:48:23 INFO - Running setup.py install for mozcrash 06:48:24 INFO - Running setup.py install for mozdebug 06:48:24 INFO - Running setup.py install for mozdevice 06:48:24 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:48:24 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:48:24 INFO - Running setup.py install for mozfile 06:48:24 INFO - Running setup.py install for mozhttpd 06:48:24 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:48:24 INFO - Running setup.py install for mozinfo 06:48:24 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:48:24 INFO - Running setup.py install for mozInstall 06:48:25 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Running setup.py install for mozleak 06:48:25 INFO - Running setup.py install for mozlog 06:48:25 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Running setup.py install for moznetwork 06:48:25 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Running setup.py install for mozprocess 06:48:25 INFO - Running setup.py install for mozprofile 06:48:25 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:48:25 INFO - Running setup.py install for mozrunner 06:48:26 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:48:26 INFO - Running setup.py install for mozscreenshot 06:48:26 INFO - Running setup.py install for moztest 06:48:26 INFO - Running setup.py install for mozversion 06:48:26 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:48:26 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:48:26 INFO - Cleaning up... 06:48:26 INFO - Return code: 0 06:48:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:48:26 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')]} 06:48:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:26 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')]} 06:48:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:26 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 0x110417a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110484228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94e1562a90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1103cc9f0>, '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 0x11012bcd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x110396990>, '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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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 06:48:26 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 06:48:26 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 06:48:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gQevzpIaHP/Render', 06:48:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:48:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:48:26 INFO - 'HOME': '/Users/cltbld', 06:48:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:48:26 INFO - 'LOGNAME': 'cltbld', 06:48:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:26 INFO - 'MOZ_NO_REMOTE': '1', 06:48:26 INFO - 'NO_EM_RESTART': '1', 06:48:26 INFO - 'PAGER': '/bin/cat', 06:48:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:48:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:26 INFO - 'PWD': '/builds/slave/test', 06:48:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:48:26 INFO - 'SHELL': '/bin/bash', 06:48:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ZYhf7q6tDT/Listeners', 06:48:26 INFO - 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/', 06:48:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:48:26 INFO - 'USER': 'cltbld', 06:48:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:48:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:48:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:26 INFO - 'XPC_FLAGS': '0x0', 06:48:26 INFO - 'XPC_SERVICE_NAME': '0', 06:48:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 06:48:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:48:26 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-mThTjD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:48:27 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:48:27 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-nZ7Yis-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:48:27 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:48:27 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-nOwz68-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:48:27 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:48:27 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-vF9yl4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.46 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:48:27 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-E67Zlv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:48:27 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:48:27 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-A2Jjse-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:48:27 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:48:27 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-QZZ6jU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.8 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:48:27 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-Url7qg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:48:27 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:48:27 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-kq3LQu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:48:27 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)) 06:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:48:28 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-9AeEZ8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:48:28 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)) 06:48:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:48:28 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-mSFBYI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:48:28 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)) 06:48:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:48:28 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-Bc0KZC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:48:28 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)) 06:48:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:48:28 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-TyYNxT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:48:28 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)) 06:48:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:48:28 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-c3Fcb_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:48:28 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)) 06:48:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:48:28 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-62uorc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:48:28 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)) 06:48:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:48:28 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-BvuHxu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:48:28 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)) 06:48:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:48:28 INFO - Running setup.py (path:/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/pip-KzEJtj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:48:28 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)) 06:48:28 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)) 06:48:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:48:28 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)) 06:48:28 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.46->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:48:28 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.46->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:48:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:48:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:31 INFO - Downloading blessings-1.5.1.tar.gz 06:48:31 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 06:48:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:48:31 INFO - Installing collected packages: blessings 06:48:31 INFO - Running setup.py install for blessings 06:48:31 INFO - Successfully installed blessings 06:48:31 INFO - Cleaning up... 06:48:31 INFO - Return code: 0 06:48:31 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:48:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:48:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:48:31 INFO - Reading from file tmpfile_stdout 06:48:31 INFO - Current package versions: 06:48:31 INFO - blessings == 1.5.1 06:48:31 INFO - blobuploader == 1.2.4 06:48:31 INFO - docopt == 0.6.1 06:48:31 INFO - manifestparser == 1.1 06:48:31 INFO - mozInstall == 1.12 06:48:31 INFO - mozcrash == 0.16 06:48:31 INFO - mozdebug == 0.1 06:48:31 INFO - mozdevice == 0.46 06:48:31 INFO - mozfile == 1.2 06:48:31 INFO - mozhttpd == 0.7 06:48:31 INFO - mozinfo == 0.8 06:48:31 INFO - mozleak == 0.1 06:48:31 INFO - mozlog == 3.0 06:48:31 INFO - moznetwork == 0.27 06:48:31 INFO - mozprocess == 0.22 06:48:31 INFO - mozprofile == 0.27 06:48:31 INFO - mozrunner == 6.11 06:48:31 INFO - mozscreenshot == 0.1 06:48:31 INFO - mozsystemmonitor == 0.0 06:48:31 INFO - moztest == 0.7 06:48:31 INFO - mozversion == 1.4 06:48:31 INFO - psutil == 3.1.1 06:48:31 INFO - requests == 1.2.3 06:48:31 INFO - wsgiref == 0.1.2 06:48:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:48:31 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')]} 06:48:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:31 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')]} 06:48:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:31 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 0x110417a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110484228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f94e1562a90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1103cc9f0>, '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 0x11012bcd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x110396990>, '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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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 06:48:31 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 06:48:31 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 06:48:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gQevzpIaHP/Render', 06:48:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:48:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:48:31 INFO - 'HOME': '/Users/cltbld', 06:48:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:48:31 INFO - 'LOGNAME': 'cltbld', 06:48:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:31 INFO - 'MOZ_NO_REMOTE': '1', 06:48:31 INFO - 'NO_EM_RESTART': '1', 06:48:31 INFO - 'PAGER': '/bin/cat', 06:48:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:48:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:31 INFO - 'PWD': '/builds/slave/test', 06:48:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:48:32 INFO - 'SHELL': '/bin/bash', 06:48:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ZYhf7q6tDT/Listeners', 06:48:32 INFO - 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/', 06:48:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:48:32 INFO - 'USER': 'cltbld', 06:48:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:48:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:48:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:32 INFO - 'XPC_FLAGS': '0x0', 06:48:32 INFO - 'XPC_SERVICE_NAME': '0', 06:48:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 06:48:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 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)) 06:48:32 INFO - Cleaning up... 06:48:32 INFO - Return code: 0 06:48:32 INFO - Running post-action listener: _resource_record_post_action 06:48:32 INFO - Running post-action listener: _start_resource_monitoring 06:48:32 INFO - Starting resource monitoring. 06:48:32 INFO - ##### 06:48:32 INFO - ##### Running install step. 06:48:32 INFO - ##### 06:48:32 INFO - Running pre-action listener: _resource_record_pre_action 06:48:32 INFO - Running main action method: install 06:48:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:48:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:48:32 INFO - Reading from file tmpfile_stdout 06:48:32 INFO - Detecting whether we're running mozinstall >=1.0... 06:48:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:48:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:48:32 INFO - Reading from file tmpfile_stdout 06:48:32 INFO - Output received: 06:48:32 INFO - Usage: mozinstall [options] installer 06:48:32 INFO - Options: 06:48:32 INFO - -h, --help show this help message and exit 06:48:32 INFO - -d DEST, --destination=DEST 06:48:32 INFO - Directory to install application into. [default: 06:48:32 INFO - "/builds/slave/test"] 06:48:32 INFO - --app=APP Application being installed. [default: firefox] 06:48:32 INFO - mkdir: /builds/slave/test/build/application 06:48:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-44.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 06:48:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-44.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 06:49:08 INFO - Reading from file tmpfile_stdout 06:49:08 INFO - Output received: 06:49:08 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 06:49:08 INFO - Running post-action listener: _resource_record_post_action 06:49:08 INFO - ##### 06:49:08 INFO - ##### Running run-tests step. 06:49:08 INFO - ##### 06:49:08 INFO - Running pre-action listener: _resource_record_pre_action 06:49:08 INFO - Running main action method: run_tests 06:49:08 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 06:49:08 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 06:49:08 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 06:49:08 INFO - 2015-12-04 06:49:08.556 screenresolution[10816:226593] starting screenresolution argv=screenresolution get 06:49:08 INFO - 2015-12-04 06:49:08.559 screenresolution[10816:226593] Display 0: 1600x1200x32@60 06:49:08 INFO - 2015-12-04 06:49:08.565 screenresolution[10817:226595] starting screenresolution argv=screenresolution list 06:49:08 INFO - Available Modes on Display 0 06:49:08 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 06:49:08 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 06:49:08 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 06:49:08 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 06:49:08 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 06:49:08 INFO - Intel HD Graphics 3000: 06:49:08 INFO - Chipset Model: Intel HD Graphics 3000 06:49:08 INFO - Type: GPU 06:49:08 INFO - Bus: Built-In 06:49:08 INFO - VRAM (Total): 512 MB 06:49:08 INFO - VRAM (Dynamic, Max): 10 06:49:08 INFO - Vendor: Intel (0x8086) 06:49:08 INFO - Device ID: 0x0116 06:49:08 INFO - Revision ID: 0x0009 06:49:08 INFO - Displays: 06:49:08 INFO - Display: 06:49:08 INFO - Resolution: 1600 x 1200 @ 60 Hz 06:49:08 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 06:49:08 INFO - Display Serial Number: 1600x1200 60 06:49:08 INFO - Main Display: Yes 06:49:08 INFO - Mirror: Off 06:49:08 INFO - Online: Yes 06:49:08 INFO - Rotation: Supported 06:49:08 INFO - Return code: 0 06:49:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:49:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:49:08 INFO - Python 2.7.3 06:49:08 INFO - Return code: 0 06:49:08 INFO - grabbing minidump binary from tooltool 06:49:08 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')]} 06:49:08 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 0x1103cc9f0>, '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 0x11012bcd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x110396990>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:49:08 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 06:49:08 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 06:49:08 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:49:08 INFO - Return code: 0 06:49:08 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 06:49:08 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:49:08 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:49:08 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 06:49:08 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:49:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0006', '--webServer', 'localhost'] in /builds/slave/test/build 06:49:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0006 --webServer localhost 06:49:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gQevzpIaHP/Render', 06:49:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:49:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:49:08 INFO - 'HOME': '/Users/cltbld', 06:49:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:49:08 INFO - 'LOGNAME': 'cltbld', 06:49:08 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:49:08 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 06:49:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:49:08 INFO - 'MOZ_NO_REMOTE': '1', 06:49:08 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:49:08 INFO - 'NO_EM_RESTART': '1', 06:49:08 INFO - 'PAGER': '/bin/cat', 06:49:08 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:49:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:49:08 INFO - 'PWD': '/builds/slave/test', 06:49:08 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:49:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:49:08 INFO - 'SHELL': '/bin/bash', 06:49:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ZYhf7q6tDT/Listeners', 06:49:08 INFO - 'TMPDIR': '/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/', 06:49:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:49:08 INFO - 'USER': 'cltbld', 06:49:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:49:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:49:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:49:08 INFO - 'XPC_FLAGS': '0x0', 06:49:08 INFO - 'XPC_SERVICE_NAME': '0', 06:49:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 06:49:08 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0006', '--webServer', 'localhost'] with output_timeout 3600 06:49:09 INFO - mozversion INFO | application_buildid: 20151203200703 06:49:09 INFO - mozversion INFO | application_changeset: 858b1b930b16a5c46634e3dad2650c517e150cb0 06:49:09 INFO - mozversion INFO | application_display_name: FirefoxDeveloperEdition 06:49:09 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:49:09 INFO - mozversion INFO | application_name: Firefox 06:49:09 INFO - mozversion INFO | application_remotingname: firefox-dev 06:49:09 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:49:09 INFO - mozversion INFO | application_vendor: Mozilla 06:49:09 INFO - mozversion INFO | application_version: 44.0a2 06:49:09 INFO - mozversion INFO | platform_buildid: 20151203200703 06:49:09 INFO - mozversion INFO | platform_changeset: 858b1b930b16a5c46634e3dad2650c517e150cb0 06:49:09 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:49:09 INFO - mozversion INFO | platform_version: 44.0a2 06:49:09 INFO - 2015-12-04 06:49:09,207 DEBUG : using testdate: 1449240549 06:49:09 INFO - 2015-12-04 06:49:09,207 DEBUG : actual date: 1449240549 06:49:09 INFO - 2015-12-04 06:49:09,215 INFO : starting webserver on 'localhost:61610' 06:49:09 INFO - 2015-12-04 06:49:09,216 INFO : Starting test suite t-yosemite-r5-0006 06:49:09 INFO - 2015-12-04 06:49:09,216 INFO : Starting test dromaeo_css 06:49:09 INFO - 2015-12-04 06:49:09,216 DEBUG : operating with platform_type : mac_ 06:49:09 INFO - 2015-12-04 06:49:09,218 INFO : Initialising browser for dromaeo_css test... 06:49:09 INFO - 2015-12-04 06:49:09,261 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/tmp4Enz4b/profile http://localhost:61610/getInfo.html 06:49:12 INFO - 2015-12-04 06:49:12,739 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 06:49:12 INFO - 2015-12-04 06:49:12,739 DEBUG : BROWSER_OUTPUT: colorDepth:24 06:49:12 INFO - 2015-12-04 06:49:12,739 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 06:49:12 INFO - 2015-12-04 06:49:12,739 DEBUG : BROWSER_OUTPUT: __metrics 06:49:12 INFO - 2015-12-04 06:49:12,756 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:49:13 INFO - 2015-12-04 06:49:13,410 INFO : Browser initialized. 06:49:13 INFO - 2015-12-04 06:49:13,410 INFO : Running cycle 1/1 for dromaeo_css test... 06:49:13 INFO - 2015-12-04 06:49:13,410 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/tmp4Enz4b/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 06:49:25 INFO - 2015-12-04 06:49:25,210 DEBUG : BROWSER_OUTPUT: RSS: Main: 197865472 06:49:25 INFO - 2015-12-04 06:49:25,210 DEBUG : BROWSER_OUTPUT: 06:50:16 INFO - 2015-12-04 06:50:16,539 DEBUG : BROWSER_OUTPUT: 1449240616537 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] 06:52:27 INFO - 2015-12-04 06:52:27,498 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/dromaeo/cssquery-dojo.html (next: http://localhost:61610/tests/dromaeo/cssquery-ext.html) 06:52:28 INFO - 2015-12-04 06:52:28,713 DEBUG : BROWSER_OUTPUT: RSS: Main: 333533184 06:52:28 INFO - 2015-12-04 06:52:28,713 DEBUG : BROWSER_OUTPUT: 06:55:31 INFO - 2015-12-04 06:55:31,263 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/dromaeo/cssquery-ext.html (next: http://localhost:61610/tests/dromaeo/cssquery-jquery.html) 06:55:31 INFO - 2015-12-04 06:55:31,845 DEBUG : BROWSER_OUTPUT: RSS: Main: 341610496 06:55:31 INFO - 2015-12-04 06:55:31,846 DEBUG : BROWSER_OUTPUT: 06:58:33 INFO - 2015-12-04 06:58:33,922 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/dromaeo/cssquery-jquery.html (next: http://localhost:61610/tests/dromaeo/cssquery-mootools.html) 06:58:34 INFO - 2015-12-04 06:58:34,503 DEBUG : BROWSER_OUTPUT: RSS: Main: 311926784 06:58:34 INFO - 2015-12-04 06:58:34,503 DEBUG : BROWSER_OUTPUT: 07:01:36 INFO - 2015-12-04 07:01:36,401 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/dromaeo/cssquery-mootools.html (next: http://localhost:61610/tests/dromaeo/cssquery-prototype.html) 07:01:36 INFO - 2015-12-04 07:01:36,988 DEBUG : BROWSER_OUTPUT: RSS: Main: 295936000 07:01:36 INFO - 2015-12-04 07:01:36,988 DEBUG : BROWSER_OUTPUT: 07:04:39 INFO - 2015-12-04 07:04:39,923 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/dromaeo/cssquery-prototype.html (next: http://localhost:61610/tests/dromaeo/cssquery-yui.html) 07:04:40 INFO - 2015-12-04 07:04:40,530 DEBUG : BROWSER_OUTPUT: RSS: Main: 299970560 07:04:40 INFO - 2015-12-04 07:04:40,531 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,013 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/dromaeo/cssquery-yui.html (next: http://localhost:61610/tests/dromaeo/cssquery-dojo.html) 07:07:43 INFO - 2015-12-04 07:07:43,273 DEBUG : BROWSER_OUTPUT: RSS: Main: 343965696 07:07:43 INFO - 2015-12-04 07:07:43,273 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,273 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:07:43 INFO - 2015-12-04 07:07:43,273 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:07:43 INFO - 2015-12-04 07:07:43,273 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:07:43 INFO - 2015-12-04 07:07:43,274 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:07:43 INFO - 2015-12-04 07:07:43,274 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3135.576697145886;3140.3091319909618;3156.984215078924;3161.383530211609;3184.1721152500345;5241.082810508165;5277.788888444457;5304;5313.867153321164;5315.840524784253;5373.059714549948;5391.083515802313;5397.433269506704;5409.972950135254;5416;4933.901321973567;4941.308216849644;4982.501749825006;5018.498150184989;5022.723750193738;5083.364579427572;5115.744212789365;5127.2052831811125;5129.717865517395;5139.614528910328;5035.3454050973505;5059.16523773577;5064.873378165557;5078.1874900016;5079.619028572872;5016.097102521545;5049.798008079691;5088.0332736780265;5100.1074811907765;5187.273781670569;5064.848054558369;5073.518015788494;5081.28861959326;5102.285680004802;5115.437301896788;5288.206768984644;5347.171188465755;5451.836444906659;5479.972600137014;5490.149026900797;5659.717014149317;5742.885142297131;5744.138379243105;5750.252467179282;5783.334916484616;5947.9702601486715;5953.58324917256;5976.073708575178;6006.969965150146;6017.368176341465;5306.8407947761625;5433.809816656477;5437.293151890308;5584.246126772915;5590.832275031756;5810.622309549865;5878.764849406061;5903.203067585821;5903.616264942765;5909.497692696169;5748;5771.538276937835;5777.884442311214;5799.420057994167;5812.244408226903;5688.431156884361;5815.04051831443;5816.79641212564;5915.08316210988;5937.554683398676;5745.597808153389;5842.8539286517325;5847.327557330961;5853.502452291517;5858.794942177004;5772.3938986406665;5781.971090144522;5784.421557844266;5786.334571524244;5801.448862358069;4416.734995900256;4469.821207151743;4503.189425903303;4505.189065968091;4531.207038768202;4099.487564054493;4151.937720934188;4160.043190066302;4169.520505141887;4175.394567787654;5507.394186639466;5512.5314348280845;5514.283143191359;5526.336839579196;5530.751116199781;5786.768529258867;5795.246617939725;5813.12803079533;5876.823695289148;5973.253343332083;5484.780608775604;5502.972485137549;5526.557875370041;5528.364238112588;5540.750666220029;5130.846074617767;5176.844694659167;5178.896422071537;5196.948030519647;5220.086484865134;5733.71331433435;5743.74153163117;5819.912701309399;5820.272465941757;5946.345901950782;5969.492593129633;5982.940170598238;5988.221531200916;5988.401159883977;6017.548683848817;6006.549508786771;6014.518838492822;6014.939850601438;6025.367336429612;6029.547783916136;5602.803901863578;5726.341470730753;5728.312602487728;5733.254676891977;5919.644821310563;5710.17202505626;5860.179574859609;5887.20522729426;5889.646621202742;5915.171875937458;5725.828225153252;5732.856678583069;5735.627184233012;5742.138679198154;5747.4252574742195;5512.7519261634125;5627.380988091225;5657.3776884543495;5741.5119714824705;5789.2763404574425;5623.493885550321;5648.802291919763;5656.915146272891;5660.886782264414;5671.914921276267;5752.07966725322;5770.047942089508;5796.275465566804;5807.303123625192;5810.506106980785;5465.480779326117;5558.72206389687;5583.162525621189;5676.148577713376;5685.232493613309 07:07:43 INFO - 2015-12-04 07:07:43,275 DEBUG : BROWSER_OUTPUT: |1;ext.html;557.381306749508;590.8345663214299;593.6972144206454;599.6042611876161;599.8500374906273;32878.34243315132;40978;41468.792656036756;41481.792591037;41529.584704152985;44244.336334955;44763.328550071776;44801.32798008033;44803;44841.10317793642;8635;8761.649534018663;9415.387999780009;9567.330286879922;9591.952040239788;11271.267367621078;11453.312801231952;11456.369899655558;11475.196736228467;11499.482523286471;11253.493592788343;11330.433478326091;11349.829752553718;11368.261063030917;11394.487248073816;8829.16122968317;8990.235829954461;11243.269187502787;11253.437328133643;11354.772904541946;11086.61196858106;11178.441077946152;11189.608363707313;11196.384198869058;11223.887761122365;41816.581834181576;42215.1556968862;42292.78853605712;42302.57697423017;42374.36438453395;3027.2280568454903;3108.9067327980197;3135.6550779414247;3146.0876345859674;3161.272907231327;28986.855065724536;29104.708952910623;29454.26364340887;29717.851410743024;29733.55399669007;2385.1771138957033;2420.140849998243;2454.9631755523683;2470.4688491974134;2529.481456301454;280497;282023;282251;282336;284792.9999999979;59592;60895.391046088975;62239;63427;63435.36564634387;57792;58243.417565824646;58431.41568584345;58441.12338314929;58668.413315866295;17892.284308627768;18096.819031809777;18099.819001810076;18100.818991810178;18119.909400453176;13934.442622294995;13953.093048951785;14024.789628155586;14255.287235638176;14261.572152835432;19808.108635111454;20075.695079819765;20078.49803754918;20083.598328033357;20097.799022009884;8933.330000250007;9098.954505227432;9101.908980910106;9110.81778364429;9118.723378726983;982.1798798003747;1005.3967619428284;1056.271172890703;1074.4305518075432;1090.8800031996475;26174.476510469685;26682.332941676224;27721.58417623737;27966.44067118646;28117.297067573065;994.6966175316453;1090.9672709818717;1113.821788513834;1170.011340417346;1220.1398014399826;11328.490217940212;14567.927160364343;14780.482683106255;14868.776968345483;15083.170425626477;335087;338632;338936;339550;341560;49138;49994.75002624963;55905.44094559084;56056.71971640116;56217;1529.090191336153;1558.462330495977;1558.6648870492897;1568.5686436230128;1571.7170909236447;30049.248768780955;31811.68188318087;31925.521117183725;31953;32679;43875.78062109797;44574.3313850286;49040.2643960348;49967.50032499774;51282.74358628183;269755;272617;274998;275541;275608;33692.3261534763;33748;34547.30905381828;34722.826385867906;35143.12142196466;48087.3233432319;48989.755051224514;49227;49625.255621166434;51087.74456127696;38340;38456.807715961244;38969.8051509752;39342;39522;37974.97439995982;37981.620183798914;38781.6121838778;38812.223755525294;38832.80583597064;38663;39520.60479395284;39548.209035819695;39599.60400395959;39666.40500392439;30284.517280513024;33471.330573388885;33585;33622.327553448304;33655.66344336525;26097.347566310993;26184.03619728566;26227.475450491263;26319;26473.33816654599 07:07:43 INFO - 2015-12-04 07:07:43,279 DEBUG : BROWSER_OUTPUT: |2;jquery.html;361.5264004154558;362.9691476224521;366.1724502624072;369.4827241861395;373.87662071516405;15480.612984675388;15579.92210038951;17928.64142717145;18681;19184.520386990316;15607.921960390211;18327.633447331045;18656.160472778723;18878.244870205177;18957;4927.866590684145;5029.06962211992;5040.647154699154;5374.731263436823;5532.1425179097305;3648.1244501319625;3738.102855314732;4952.603791696655;5026.597872170218;5062.519060689228;4960.131976904046;4999.950000500003;5001.749912504379;5001.874953126165;5005.799768009293;4879.853604391874;4992.600591952635;5000.499950005007;5028.597712183053;5042.268871013719;4316.179925814085;4327.004788898539;4328.242557552416;4329.7618630975285;4331.6534677225745;14053.718925621533;14147.575572732834;14288.785668214985;14291.57125286243;14306.21315827629;1860.4697661166638;1997.57052233769;2009.7387339645898;2052.0868213644935;2102.2536999365157;9796.510174491246;10138.695839124764;10184.94907525465;10242.078212960869;10587;1650.7523871419264;1655.7516372544094;1655.908925009124;1702.5743564108973;1757.5606098475382;55152.72423637896;56881.43118568803;57479;57917;58066.129008065334;6963.1644202696;6982.092327997328;7005.334493223136;7019.929800701928;7058.470614703918;8071;8075.152109028468;8088;8093.595320233965;8097.311728503143;5731.312242530839;5819.76720931158;5933.080372542263;5937.9406205937385;5959.761609535657;6375.426211640882;6386.2975072741965;6420.036994450777;6428.6785660717715;6429.9678501607195;3180.904572862818;3182.4112539179864;3187.3784612000436;3204.9198770030935;3208.4545627242956;1077.5582011375297;1089.0906093411932;1108.3959242213014;1143.451143451148;1151.1423989127986;428.4173524007347;437.62364366645295;440.61006009681665;455.9863204103882;458.52542618389805;11306.773864522664;11623.360715160577;11638.592649257236;11759.118066144902;11819.054475641928;406.76610948704615;419.0968462962321;422.3116320397732;428.52433798483656;442.5684957166737;5901.439363260483;6128.754849805958;6211.068339748984;6212.751489940351;6240.563160578716;590291;626202;631018;633717;633986;78179.60910195412;78453.60773196098;78461.60769196232;78646.21353786503;79103.23138690119;468.91325104855713;471.89382388962207;472.65496187782423;472.9125111854318;473.5383001573507;11408.201425900439;11614.593489227836;11908.583199587973;11915.940420297842;11944.2833429991;36635;37102.25795484129;39258.2148357037;39290.60709392984;39358;49660.503394965584;50183.74908125436;51609;51905;52113.7394313026;8317.126701696236;8390.07709152005;8521.403501754818;8555.786105347415;8563.486190828571;12433.254004759743;12705.36473176356;12836.486540538273;12855.678608034874;12861.614151575468;9367.484788336435;9831.31180817336;10721.088707459954;10921.235513514295;11002.229843910849;9931.304808663614;9985.400875947467;10004.899951000396;10396.324238924446;10616.513688083829;10863.293885897392;10892.782144357227;10898.673039808818;10902.291351062155;10980.780384392108;8218.260356567938;8250.752477425447;8307;8315.459495132796;8320.583970801557;10859.83710244331;10873.401962892116;11055.889441105486;11158.107351411705;11167.497462614365 07:07:43 INFO - 2015-12-04 07:07:43,279 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1262.545483625895;1375.346710312601;1378.4279523997548;1736.3922627080524;1837.9632407351853;7270.200277969419;7560;7700.922990770091;7713.922860771398;7737.767866963986;7644.923550764491;7850.136484986647;7856.332211762007;7859.135495095535;7882.369410447165;2232.8771917544527;2259.5029093599383;2264.9660255096187;2267.2744721689064;2268.0247493577754;2296.552172326397;2300.424893776556;2342.5666251743396;2343.50786334869;2348.635961425982;2267.920622778203;2283.04112272845;2298.6322188449853;2306.561753266874;2307.7807608277185;2247.0337754765446;2252.9887350563226;2268.7617800130997;2268.897899594514;2271.1596709217697;2230.475838178027;2245.4610893385634;2247.292102987554;2247.73027236731;2249.4713742270555;7096.935459681037;7250.4199664026755;7787.143414224431;7810.843783124305;7829.41279404047;4687.812487500496;4833.9033219335415;4848.054629347279;4848.854534363974;4858.78135483904;3069.8004629699;3089.3975674743433;3138.356636889432;3138.7802853800245;3193.96806031939;911.1617312072909;929.3866048408019;933.5658918602883;958.094600602431;961.8653388525612;10209.846852297222;10297.433641149808;10316.484175791105;10331.070203681706;10334.586616535329;4128.814203360856;4139.3583994480905;4203.726757760735;4271.530131685512;4296.2266791977745;8519.57402129891;8539.658413663508;8539.957300213458;8545.444546104483;8556.058833528306;4824.565789079;4828.806847726122;4837.516248375205;4850.393700787402;4850.587700045536;4504.459464864171;4504.594586487166;4505.098980203907;4506.954930450654;4510.007798284372;3337.6161741399565;3382.864685412556;3383.3233353329433;3391;3417.45320748684;1043.1967385113421;1052.7315534538643;1052.7947050325113;1055.767731099157;1063.4257500949554;987.9506024698736;1011.0849681038671;1129.4747942206914;1337.819394381746;1339.819124418191;7339.88990165148;7504.512206706547;7534.962325188339;7546.9245307546225;7557.697692092364;470.68228945461675;475.6313856760969;481.28529134235635;481.89157439575814;482.5777444735856;5710.7430165642645;5830.154627578977;5881.941180588139;5944.732487038007;5954.285485741739;8265.380096492787;8323.167683231628;8328.83342333162;8333.291670207978;8334.333253339719;9010;9051.456912585267;9241.861372079424;9333.673321433716;9340.906590934139;7294.489385743053;7357.705691772269;7377.668004939791;7381.261873812576;7396.9260307396235;7256.89114663291;7294.817629559091;7345.816354591178;7367.042284502981;7378.372838308804;8204;8278.172182781673;8326.50040997542;8346.540940248102;8401.285890699359;8325;8487.151284871463;8490.193431623986;8573.657053717781;8597.656093756179;6672.132622759204;6745.797626071226;6750.257471678014;6751.527393082437;6758.898616520658;7364.189939106587;7585.355244804254;7598.734044308423;7611.238876112345;7617.466777325534;7096.822579435556;7119.75080872167;7162.247963963917;7210.675519601526;7224.422046236394;6860.176778786378;6894;7019.859602808017;7100.467464940253;7114.57312561248;7103;7124.145102587722;7206.7117315306805;7208.315210055036;7217.855642887218;6497;6531.052997315268;6542.640154791532;6549.672516374258;6553.279139294578;6586.1438013058;6626.237982632059;6626.602403855592;6631.0716499689115;6639.70121344531 07:07:43 INFO - 2015-12-04 07:07:43,282 DEBUG : BROWSER_OUTPUT: |4;prototype.html;327.9376918385507;340.4246822869351;344.6364085889389;344.9241166943273;348.4825034823285;6163.352847950957;6227.283862355825;6236.625802451845;6313.242410910691;6322.9051564226575;6120.326764055962;6149.81550553483;6184.536159788011;6195.659238741868;6227.221597300338;4759.595434388072;4760.4525479569775;4764.142454358214;4764.618830493552;4765.523447655224;4612.7924243409125;4705.341252224691;4714.669973101884;4768.594669453083;4789.760511974388;4704.458987216462;4738.431388233417;4739.454962679284;4768.380110585619;4776.570108690217;4731.7634118293945;4737.976310118462;4756.7859446325;4761.2143996240575;4768;4114.362273847529;4114.5679703630985;4124.4019617155345;4125.855595054189;4132.73137246081;5792.160136780185;6039.758409663608;6062.666553339564;6106.694665266719;6107.786227482017;5440.075187218183;5450.5367043801325;5458.344998600153;5468.234447177399;5469.781208751645;6583.440407565315;6583.440407565363;6593.340665933369;6604;6606.537542372036;4339.7396156230725;4437.622802061828;4541.091781643651;4549.044700612875;4551.499335073139;6613;6671.166104236971;6702.731890724365;6802.931970680279;6822.215445223813;4449.1101779644205;4477.798499067485;4478.708883922534;4494.10117976406;4499.055198408306;4565.223911934979;4572.634189264851;4575.107853968444;4576.908461830745;4592.97703511487;5157.974210128926;5275.683458992473;5299.602529810202;5309.867253318621;5325.3875804282225;6603.7688680895935;6605.76879809214;6608.372204640552;6619.966900165468;6654;1633.2650307361735;1639.3606493467557;1643.0306119389618;1643.2276829889934;1645.9506214813575;1024.283001898659;1037.8754549453963;1065.3980501016902;1075.7203127186988;1083.496174278964;6299.5275354348605;6299.716512756937;6306.2747784004505;6323.430891219812;6339.429451349401;6857.588544687334;6882.69027893736;6895.75864844728;6909.136357955255;6910.2744211858035;6188.195534580475;6316.715747791361;6324.367563243639;6326.2092238470195;6328.873422531524;3757.511523501927;3786.981065094712;3797.5442946846556;3801.429785532137;3805.5433347997864;6871.828204294832;6882.827929301708;6897.3447522485285;6901.033855260268;6918.827029324307;6868.072810170663;6972.79081627552;6990.26602206761;6991.335823096798;7028.2620324866175;6861.416779573692;6868.244493105754;6941.028256044056;6942.548734332252;6968.0941477607585;6895.75864844728;6912.4815638826285;6913.274106218774;6925.376716095576;6946.6179360135675;6518.152640156939;6608.603483790988;6766.8646627068165;6767.492438067066;6811.93188068113;6787.389134977876;6829.419499342612;6889.379955804002;6897.448204143757;6929.1684997800585;4431.711938723973;4498.055408364149;4509.819607215674;4515.571020753023;4517.841875534341;6632.436242919213;6788.389044985777;6799;6803.625800580818;6809.557378770364;6596.5052621052655;6611.404973552403;6620.304867988792;6620.66896655175;6711.395974362135;6701.296363881722;6704.027915952257;6714.3957043866285;6724.899126513008;6726.764563240263;6351.396617321347;6538.117354157318;6562.048502967138;6576.868462630816;6582.8354291143105;6709.698063587052;6712.2616512184595;6716.5634233774645;6723;6735.360140786617;6537.901931470937;6548.050532672831;6548.508861835477;6551.6069035858;6597.2742998271115 07:07:43 INFO - 2015-12-04 07:07:43,284 DEBUG : BROWSER_OUTPUT: |5;yui.html;749.2694622742824;764.1059959846979;790.5493868494957;792.7383963292115;803.0523981701593;13842.58472245833;14234.359453824576;14244.999999999987;14246.786298205509;14276.143431394124;12478.126531142801;12480.126391152622;12482.37588120595;12976.156549824254;13461.461541538327;735.0958321264848;745.202633182495;926.8887733471993;945.1352012908216;946.8390373636464;928.5867788833972;936.8688383626297;947.2469386837481;947.5641205045653;947.6304241345846;988.0169231614553;996.5266498413232;997.0328781082375;997.5860018092483;997.675755379501;788.9526628402314;800.8358286551272;960.0927123867948;977.3549457358181;992.6525715999414;724.6376811594203;724.764451553242;725.2892165677613;725.4595326481752;725.4849057169416;13898.861011389858;14084.647883802987;14092.084014539125;14094.647633809134;14124.576262712135;11265.436728163559;11320.150988675883;11355.659330220107;11590.478428470655;11697.181197316191;9334.826694155046;9626.566804493814;9647.324687271894;9672.661456849048;9755.756106097404;3358.2108204571905;3436.244026314207;3458.515807786912;3466.6706662866986;3588.9282214355826;47850.76074619604;48226.517734822555;48318.27522587164;52330.738346308026;52758.20862687024;8878.689245876492;8950.418222815626;9226;9432.622695092257;9441.669541566012;19721;19744.210231590863;19771.110300036533;19781.109850056782;19799.802001980082;7055.6119413431725;7064;7340.926590734024;7359.4480413968095;7420.962895185489;3942.743721658083;4032.5564187939303;4038.2529232092156;4131.400946862748;4140.0891803803115;3126.5622812806228;3150.8582113804932;3154.369126174774;3155.100796273051;3156.542301366335;429.41813842243937;432.76414354177047;436.5765207748479;451.21038183179434;453.6325576283221;488.28466296875246;575.6718670357856;602.5270162922172;610.6702380714364;626.136736336803;8045.839083218303;8052.838943221102;8074.83850323002;8090.474119182352;8233.876491852627;533.751805410486;550.2544052808387;600.8818913330545;620.965846878417;627.6736097229415;3625.4743062255825;3776.735628506033;3841.8847434577006;4072.2873497137884;4265.594768496988;59442.702786486654;59896.401035989955;60173.69913150494;64345.35654643487;64641.03038454427;51519.48480515222;51555.22667159996;51684.48315516872;55271;55476;48466.757666211444;49757.99999999927;50272.497275026784;50717;50899.49100509022;8161;8376.53929033909;8439.28266097364;8555.61499732501;8602.225799678059;37997.81001094977;38025.61974380331;38638.420423693104;38899.416508752955;38976.6102338973;45475.545244548455;50090.2486462696;50309.74845125751;50399.49600504095;50439.74780126076;7812.3359514439635;7864.84270314602;7877.566733829465;7889.487183333065;8127.1466496017065;11253.099752019982;11551.942240288745;11555;11595.768084638428;11620.825687614524;10201.307656437544;10352.948235258775;10410.063094321547;10449.738756531147;11187.664370068911;10897.782044359226;11027.0075693188;11165.665030049111;11236.101111911192;11243.10055195566;10363.32638378503;10459.94770026145;10670.519826607666;10774.353538787698;11211.831822522505;9413.764655883657;9604.327697061139;9668.323217374716;9866.703998880044;9952.402855828674;9306.302027347841;9429.669961551313;9436.150746432853;9443.386179898285;9589.568469419033 07:07:43 INFO - 2015-12-04 07:07:43,284 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:07:43 INFO - 2015-12-04 07:07:43,284 DEBUG : BROWSER_OUTPUT: __start_cc_report 07:07:43 INFO - 2015-12-04 07:07:43,284 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,979 07:07:43 INFO - 2015-12-04 07:07:43,284 DEBUG : BROWSER_OUTPUT: __end_cc_report 07:07:43 INFO - 2015-12-04 07:07:43,285 DEBUG : BROWSER_OUTPUT: __startTimestamp1449241663270__endTimestamp 07:07:43 INFO - 2015-12-04 07:07:43,285 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,285 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:07:43 INFO - 2015-12-04 07:07:43,285 DEBUG : BROWSER_OUTPUT: Number of tests: 6 07:07:43 INFO - 2015-12-04 07:07:43,285 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,285 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5437.72 Median:5648.80 stddev:587.87 (10.4%) stddev-sans-first:561.25 07:07:43 INFO - 2015-12-04 07:07:43,287 DEBUG : BROWSER_OUTPUT: Values: 3135.6 3140.3 3157.0 3161.4 3184.2 5241.1 5277.8 5304.0 5313.9 5315.8 5373.1 5391.1 5397.4 5410.0 5416.0 4933.9 4941.3 4982.5 5018.5 5022.7 5083.4 5115.7 5127.2 5129.7 5139.6 5035.3 5059.2 5064.9 5078.2 5079.6 5016.1 5049.8 5088.0 5100.1 5187.3 5064.8 5073.5 5081.3 5102.3 5115.4 5288.2 5347.2 5451.8 5480.0 5490.1 5659.7 5742.9 5744.1 5750.3 5783.3 5948.0 5953.6 5976.1 6007.0 6017.4 5306.8 5433.8 5437.3 5584.2 5590.8 5810.6 5878.8 5903.2 5903.6 5909.5 5748.0 5771.5 5777.9 5799.4 5812.2 5688.4 5815.0 5816.8 5915.1 5937.6 5745.6 5842.9 5847.3 5853.5 5858.8 5772.4 5782.0 5784.4 5786.3 5801.4 4416.7 4469.8 4503.2 4505.2 4531.2 4099.5 4151.9 4160.0 4169.5 4175.4 5507.4 5512.5 5514.3 5526.3 5530.8 5786.8 5795.2 5813.1 5876.8 5973.3 5484.8 5503.0 5526.6 5528.4 5540.8 5130.8 5176.8 5178.9 5196.9 5220.1 5733.7 5743.7 5819.9 5820.3 5946.3 5969.5 5982.9 5988.2 5988.4 6017.5 6006.5 6014.5 6014.9 6025.4 6029.5 5602.8 5726.3 5728.3 5733.3 5919.6 5710.2 5860.2 5887.2 5889.6 5915.2 5725.8 5732.9 5735.6 5742.1 5747.4 5512.8 5627.4 5657.4 5741.5 5789.3 5623.5 5648.8 5656.9 5660.9 5671.9 5752.1 5770.0 5796.3 5807.3 5810.5 5465.5 5558.7 5583.2 5676.1 5685.2 07:07:43 INFO - 2015-12-04 07:07:43,287 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,287 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:48048.24 Median:32316.00 stddev:78112.34 (241.7%) stddev-sans-first:78250.07 07:07:43 INFO - 2015-12-04 07:07:43,288 DEBUG : BROWSER_OUTPUT: Values: 557.4 590.8 593.7 599.6 599.9 32878.3 40978.0 41468.8 41481.8 41529.6 44244.3 44763.3 44801.3 44803.0 44841.1 8635.0 8761.6 9415.4 9567.3 9592.0 11271.3 11453.3 11456.4 11475.2 11499.5 11253.5 11330.4 11349.8 11368.3 11394.5 8829.2 8990.2 11243.3 11253.4 11354.8 11086.6 11178.4 11189.6 11196.4 11223.9 41816.6 42215.2 42292.8 42302.6 42374.4 3027.2 3108.9 3135.7 3146.1 3161.3 28986.9 29104.7 29454.3 29717.9 29733.6 2385.2 2420.1 2455.0 2470.5 2529.5 280497.0 282023.0 282251.0 282336.0 284793.0 59592.0 60895.4 62239.0 63427.0 63435.4 57792.0 58243.4 58431.4 58441.1 58668.4 17892.3 18096.8 18099.8 18100.8 18119.9 13934.4 13953.1 14024.8 14255.3 14261.6 19808.1 20075.7 20078.5 20083.6 20097.8 8933.3 9099.0 9101.9 9110.8 9118.7 982.2 1005.4 1056.3 1074.4 1090.9 26174.5 26682.3 27721.6 27966.4 28117.3 994.7 1091.0 1113.8 1170.0 1220.1 11328.5 14567.9 14780.5 14868.8 15083.2 335087.0 338632.0 338936.0 339550.0 341560.0 49138.0 49994.8 55905.4 56056.7 56217.0 1529.1 1558.5 1558.7 1568.6 1571.7 30049.2 31811.7 31925.5 31953.0 32679.0 43875.8 44574.3 49040.3 49967.5 51282.7 269755.0 272617.0 274998.0 275541.0 275608.0 33692.3 33748.0 34547.3 34722.8 35143.1 48087.3 48989.8 49227.0 49625.3 51087.7 38340.0 38456.8 38969.8 39342.0 39522.0 37975.0 37981.6 38781.6 38812.2 38832.8 38663.0 39520.6 39548.2 39599.6 39666.4 30284.5 33471.3 33585.0 33622.3 33655.7 26097.3 26184.0 26227.5 26319.0 26473.3 07:07:43 INFO - 2015-12-04 07:07:43,288 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,289 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:29737.63 Median:4330.71 stddev:102000.86 (2355.3%) stddev-sans-first:102263.14 07:07:43 INFO - 2015-12-04 07:07:43,289 DEBUG : BROWSER_OUTPUT: Values: 361.5 363.0 366.2 369.5 373.9 15480.6 15579.9 17928.6 18681.0 19184.5 15607.9 18327.6 18656.2 18878.2 18957.0 4927.9 5029.1 5040.6 5374.7 5532.1 3648.1 3738.1 4952.6 5026.6 5062.5 4960.1 5000.0 5001.7 5001.9 5005.8 4879.9 4992.6 5000.5 5028.6 5042.3 4316.2 4327.0 4328.2 4329.8 4331.7 14053.7 14147.6 14288.8 14291.6 14306.2 1860.5 1997.6 2009.7 2052.1 2102.3 9796.5 10138.7 10184.9 10242.1 10587.0 1650.8 1655.8 1655.9 1702.6 1757.6 55152.7 56881.4 57479.0 57917.0 58066.1 6963.2 6982.1 7005.3 7019.9 7058.5 8071.0 8075.2 8088.0 8093.6 8097.3 5731.3 5819.8 5933.1 5937.9 5959.8 6375.4 6386.3 6420.0 6428.7 6430.0 3180.9 3182.4 3187.4 3204.9 3208.5 1077.6 1089.1 1108.4 1143.5 1151.1 428.4 437.6 440.6 456.0 458.5 11306.8 11623.4 11638.6 11759.1 11819.1 406.8 419.1 422.3 428.5 442.6 5901.4 6128.8 6211.1 6212.8 6240.6 590291.0 626202.0 631018.0 633717.0 633986.0 78179.6 78453.6 78461.6 78646.2 79103.2 468.9 471.9 472.7 472.9 473.5 11408.2 11614.6 11908.6 11915.9 11944.3 36635.0 37102.3 39258.2 39290.6 39358.0 49660.5 50183.7 51609.0 51905.0 52113.7 8317.1 8390.1 8521.4 8555.8 8563.5 12433.3 12705.4 12836.5 12855.7 12861.6 9367.5 9831.3 10721.1 10921.2 11002.2 9931.3 9985.4 10004.9 10396.3 10616.5 10863.3 10892.8 10898.7 10902.3 10980.8 8218.3 8250.8 8307.0 8315.5 8320.6 10859.8 10873.4 11055.9 11158.1 11167.5 07:07:43 INFO - 2015-12-04 07:07:43,289 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,289 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5399.13 Median:6626.42 stddev:2784.54 (42.0%) stddev-sans-first:2774.99 07:07:43 INFO - 2015-12-04 07:07:43,291 DEBUG : BROWSER_OUTPUT: Values: 1262.5 1375.3 1378.4 1736.4 1838.0 7270.2 7560.0 7700.9 7713.9 7737.8 7644.9 7850.1 7856.3 7859.1 7882.4 2232.9 2259.5 2265.0 2267.3 2268.0 2296.6 2300.4 2342.6 2343.5 2348.6 2267.9 2283.0 2298.6 2306.6 2307.8 2247.0 2253.0 2268.8 2268.9 2271.2 2230.5 2245.5 2247.3 2247.7 2249.5 7096.9 7250.4 7787.1 7810.8 7829.4 4687.8 4833.9 4848.1 4848.9 4858.8 3069.8 3089.4 3138.4 3138.8 3194.0 911.2 929.4 933.6 958.1 961.9 10209.8 10297.4 10316.5 10331.1 10334.6 4128.8 4139.4 4203.7 4271.5 4296.2 8519.6 8539.7 8540.0 8545.4 8556.1 4824.6 4828.8 4837.5 4850.4 4850.6 4504.5 4504.6 4505.1 4507.0 4510.0 3337.6 3382.9 3383.3 3391.0 3417.5 1043.2 1052.7 1052.8 1055.8 1063.4 988.0 1011.1 1129.5 1337.8 1339.8 7339.9 7504.5 7535.0 7546.9 7557.7 470.7 475.6 481.3 481.9 482.6 5710.7 5830.2 5881.9 5944.7 5954.3 8265.4 8323.2 8328.8 8333.3 8334.3 9010.0 9051.5 9241.9 9333.7 9340.9 7294.5 7357.7 7377.7 7381.3 7396.9 7256.9 7294.8 7345.8 7367.0 7378.4 8204.0 8278.2 8326.5 8346.5 8401.3 8325.0 8487.2 8490.2 8573.7 8597.7 6672.1 6745.8 6750.3 6751.5 6758.9 7364.2 7585.4 7598.7 7611.2 7617.5 7096.8 7119.8 7162.2 7210.7 7224.4 6860.2 6894.0 7019.9 7100.5 7114.6 7103.0 7124.1 7206.7 7208.3 7217.9 6497.0 6531.1 6542.6 6549.7 6553.3 6586.1 6626.2 6626.6 6631.1 6639.7 07:07:43 INFO - 2015-12-04 07:07:43,291 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,291 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5493.16 Median:6303.00 stddev:1673.95 (26.6%) stddev-sans-first:1633.14 07:07:43 INFO - 2015-12-04 07:07:43,292 DEBUG : BROWSER_OUTPUT: Values: 327.9 340.4 344.6 344.9 348.5 6163.4 6227.3 6236.6 6313.2 6322.9 6120.3 6149.8 6184.5 6195.7 6227.2 4759.6 4760.5 4764.1 4764.6 4765.5 4612.8 4705.3 4714.7 4768.6 4789.8 4704.5 4738.4 4739.5 4768.4 4776.6 4731.8 4738.0 4756.8 4761.2 4768.0 4114.4 4114.6 4124.4 4125.9 4132.7 5792.2 6039.8 6062.7 6106.7 6107.8 5440.1 5450.5 5458.3 5468.2 5469.8 6583.4 6583.4 6593.3 6604.0 6606.5 4339.7 4437.6 4541.1 4549.0 4551.5 6613.0 6671.2 6702.7 6802.9 6822.2 4449.1 4477.8 4478.7 4494.1 4499.1 4565.2 4572.6 4575.1 4576.9 4593.0 5158.0 5275.7 5299.6 5309.9 5325.4 6603.8 6605.8 6608.4 6620.0 6654.0 1633.3 1639.4 1643.0 1643.2 1646.0 1024.3 1037.9 1065.4 1075.7 1083.5 6299.5 6299.7 6306.3 6323.4 6339.4 6857.6 6882.7 6895.8 6909.1 6910.3 6188.2 6316.7 6324.4 6326.2 6328.9 3757.5 3787.0 3797.5 3801.4 3805.5 6871.8 6882.8 6897.3 6901.0 6918.8 6868.1 6972.8 6990.3 6991.3 7028.3 6861.4 6868.2 6941.0 6942.5 6968.1 6895.8 6912.5 6913.3 6925.4 6946.6 6518.2 6608.6 6766.9 6767.5 6811.9 6787.4 6829.4 6889.4 6897.4 6929.2 4431.7 4498.1 4509.8 4515.6 4517.8 6632.4 6788.4 6799.0 6803.6 6809.6 6596.5 6611.4 6620.3 6620.7 6711.4 6701.3 6704.0 6714.4 6724.9 6726.8 6351.4 6538.1 6562.0 6576.9 6582.8 6709.7 6712.3 6716.6 6723.0 6735.4 6537.9 6548.1 6548.5 6551.6 6597.3 07:07:43 INFO - 2015-12-04 07:07:43,292 DEBUG : BROWSER_OUTPUT: 07:07:43 INFO - 2015-12-04 07:07:43,292 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:14156.99 Median:51619.85 stddev:17187.07 (33.3%) stddev-sans-first:17205.79 07:07:43 INFO - 2015-12-04 07:07:43,294 DEBUG : BROWSER_OUTPUT: Values: 749.3 764.1 790.5 792.7 803.1 13842.6 14234.4 14245.0 14246.8 14276.1 12478.1 12480.1 12482.4 12976.2 13461.5 735.1 745.2 926.9 945.1 946.8 928.6 936.9 947.2 947.6 947.6 988.0 996.5 997.0 997.6 997.7 789.0 800.8 960.1 977.4 992.7 724.6 724.8 725.3 725.5 725.5 13898.9 14084.6 14092.1 14094.6 14124.6 11265.4 11320.2 11355.7 11590.5 11697.2 9334.8 9626.6 9647.3 9672.7 9755.8 3358.2 3436.2 3458.5 3466.7 3588.9 47850.8 48226.5 48318.3 52330.7 52758.2 8878.7 8950.4 9226.0 9432.6 9441.7 19721.0 19744.2 19771.1 19781.1 19799.8 7055.6 7064.0 7340.9 7359.4 7421.0 3942.7 4032.6 4038.3 4131.4 4140.1 3126.6 3150.9 3154.4 3155.1 3156.5 429.4 432.8 436.6 451.2 453.6 488.3 575.7 602.5 610.7 626.1 8045.8 8052.8 8074.8 8090.5 8233.9 533.8 550.3 600.9 621.0 627.7 3625.5 3776.7 3841.9 4072.3 4265.6 59442.7 59896.4 60173.7 64345.4 64641.0 51519.5 51555.2 51684.5 55271.0 55476.0 48466.8 49758.0 50272.5 50717.0 50899.5 8161.0 8376.5 8439.3 8555.6 8602.2 37997.8 38025.6 38638.4 38899.4 38976.6 45475.5 50090.2 50309.7 50399.5 50439.7 7812.3 7864.8 7877.6 7889.5 8127.1 11253.1 11551.9 11555.0 11595.8 11620.8 10201.3 10352.9 10410.1 10449.7 11187.7 10897.8 11027.0 11165.7 11236.1 11243.1 10363.3 10459.9 10670.5 10774.4 11211.8 9413.8 9604.3 9668.3 9866.7 9952.4 9306.3 9429.7 9436.2 9443.4 9589.6 07:07:43 INFO - 2015-12-04 07:07:43,294 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:07:43 INFO - 2015-12-04 07:07:43,294 DEBUG : BROWSER_OUTPUT: 07:07:44 INFO - 2015-12-04 07:07:44,000 INFO : Browser exited with error code: 0 07:07:44 INFO - 2015-12-04 07:07:44,027 INFO : Completed test dromaeo_css (00:18:34) 07:07:44 INFO - 2015-12-04 07:07:44,027 INFO : Starting test kraken 07:07:44 INFO - 2015-12-04 07:07:44,027 DEBUG : operating with platform_type : mac_ 07:07:44 INFO - 2015-12-04 07:07:44,028 INFO : Initialising browser for kraken test... 07:07:44 INFO - 2015-12-04 07:07:44,042 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/tmpsfYaJL/profile http://localhost:61610/getInfo.html 07:07:46 INFO - 2015-12-04 07:07:46,077 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:07:46 INFO - 2015-12-04 07:07:46,078 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:07:46 INFO - 2015-12-04 07:07:46,078 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 07:07:46 INFO - 2015-12-04 07:07:46,078 DEBUG : BROWSER_OUTPUT: __metrics 07:07:46 INFO - 2015-12-04 07:07:46,095 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:07:46 INFO - 2015-12-04 07:07:46,700 INFO : Browser initialized. 07:07:46 INFO - 2015-12-04 07:07:46,701 INFO : Running cycle 1/1 for kraken test... 07:07:46 INFO - 2015-12-04 07:07:46,701 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/tmpsfYaJL/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:07:58 INFO - 2015-12-04 07:07:58,461 DEBUG : BROWSER_OUTPUT: RSS: Main: 197672960 07:07:58 INFO - 2015-12-04 07:07:58,462 DEBUG : BROWSER_OUTPUT: 07:08:01 INFO - 2015-12-04 07:08:01,037 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:61610/tests/kraken/driver.html?testName=audio-beat-detection) 07:08:01 INFO - 2015-12-04 07:08:01,623 DEBUG : BROWSER_OUTPUT: RSS: Main: 263053312 07:08:01 INFO - 2015-12-04 07:08:01,623 DEBUG : BROWSER_OUTPUT: 07:08:04 INFO - 2015-12-04 07:08:04,268 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:61610/tests/kraken/driver.html?testName=audio-dft) 07:08:04 INFO - 2015-12-04 07:08:04,848 DEBUG : BROWSER_OUTPUT: RSS: Main: 275107840 07:08:04 INFO - 2015-12-04 07:08:04,848 DEBUG : BROWSER_OUTPUT: 07:08:07 INFO - 2015-12-04 07:08:07,669 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:61610/tests/kraken/driver.html?testName=audio-fft) 07:08:08 INFO - 2015-12-04 07:08:08,255 DEBUG : BROWSER_OUTPUT: RSS: Main: 261292032 07:08:08 INFO - 2015-12-04 07:08:08,255 DEBUG : BROWSER_OUTPUT: 07:08:10 INFO - 2015-12-04 07:08:10,289 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:61610/tests/kraken/driver.html?testName=audio-oscillator) 07:08:10 INFO - 2015-12-04 07:08:10,875 DEBUG : BROWSER_OUTPUT: RSS: Main: 263876608 07:08:10 INFO - 2015-12-04 07:08:10,875 DEBUG : BROWSER_OUTPUT: 07:08:13 INFO - 2015-12-04 07:08:13,049 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:61610/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:08:13 INFO - 2015-12-04 07:08:13,636 DEBUG : BROWSER_OUTPUT: RSS: Main: 262959104 07:08:13 INFO - 2015-12-04 07:08:13,637 DEBUG : BROWSER_OUTPUT: 07:08:16 INFO - 2015-12-04 07:08:16,672 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:61610/tests/kraken/driver.html?testName=imaging-darkroom) 07:08:17 INFO - 2015-12-04 07:08:17,254 DEBUG : BROWSER_OUTPUT: RSS: Main: 263880704 07:08:17 INFO - 2015-12-04 07:08:17,255 DEBUG : BROWSER_OUTPUT: 07:08:20 INFO - 2015-12-04 07:08:20,381 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:61610/tests/kraken/driver.html?testName=imaging-desaturate) 07:08:20 INFO - 2015-12-04 07:08:20,964 DEBUG : BROWSER_OUTPUT: RSS: Main: 262733824 07:08:20 INFO - 2015-12-04 07:08:20,965 DEBUG : BROWSER_OUTPUT: 07:08:23 INFO - 2015-12-04 07:08:23,821 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:61610/tests/kraken/driver.html?testName=json-parse-financial) 07:08:24 INFO - 2015-12-04 07:08:24,406 DEBUG : BROWSER_OUTPUT: RSS: Main: 264388608 07:08:24 INFO - 2015-12-04 07:08:24,406 DEBUG : BROWSER_OUTPUT: 07:08:26 INFO - 2015-12-04 07:08:26,003 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:61610/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:08:26 INFO - 2015-12-04 07:08:26,567 DEBUG : BROWSER_OUTPUT: RSS: Main: 297852928 07:08:26 INFO - 2015-12-04 07:08:26,567 DEBUG : BROWSER_OUTPUT: 07:08:28 INFO - 2015-12-04 07:08:28,390 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:61610/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:08:29 INFO - 2015-12-04 07:08:29,005 DEBUG : BROWSER_OUTPUT: RSS: Main: 298856448 07:08:29 INFO - 2015-12-04 07:08:29,005 DEBUG : BROWSER_OUTPUT: 07:08:31 INFO - 2015-12-04 07:08:31,051 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:61610/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:08:31 INFO - 2015-12-04 07:08:31,635 DEBUG : BROWSER_OUTPUT: RSS: Main: 305512448 07:08:31 INFO - 2015-12-04 07:08:31,635 DEBUG : BROWSER_OUTPUT: 07:08:34 INFO - 2015-12-04 07:08:34,147 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:61610/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:08:34 INFO - 2015-12-04 07:08:34,732 DEBUG : BROWSER_OUTPUT: RSS: Main: 307675136 07:08:34 INFO - 2015-12-04 07:08:34,732 DEBUG : BROWSER_OUTPUT: 07:08:37 INFO - 2015-12-04 07:08:37,263 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:61610/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:08:37 INFO - 2015-12-04 07:08:37,849 DEBUG : BROWSER_OUTPUT: RSS: Main: 307384320 07:08:37 INFO - 2015-12-04 07:08:37,849 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,561 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:61610/tests/kraken/driver.html?testName=ai-astar) 07:08:39 INFO - 2015-12-04 07:08:39,826 DEBUG : BROWSER_OUTPUT: RSS: Main: 365551616 07:08:39 INFO - 2015-12-04 07:08:39,826 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,826 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:08:39 INFO - 2015-12-04 07:08:39,826 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:08:39 INFO - 2015-12-04 07:08:39,826 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:08:39 INFO - 2015-12-04 07:08:39,826 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:08:39 INFO - 2015-12-04 07:08:39,826 DEBUG : BROWSER_OUTPUT: |0;ai-astar;108;110;103;107;110;110;96;108;97;108 07:08:39 INFO - 2015-12-04 07:08:39,826 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;154;128;164;154;129;148;126;159;153;140 07:08:39 INFO - 2015-12-04 07:08:39,827 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;162;161;161;160;161;162;162;162;161 07:08:39 INFO - 2015-12-04 07:08:39,827 DEBUG : BROWSER_OUTPUT: |3;audio-fft;82;82;75;124;65;69;69;68;120;67 07:08:39 INFO - 2015-12-04 07:08:39,827 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;100;100;137;87;89;88;127;87;87;130 07:08:39 INFO - 2015-12-04 07:08:39,827 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;120;120;115;120;120;114;120;120;120;120 07:08:39 INFO - 2015-12-04 07:08:39,827 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;125;124;125;125;125;124;124;124;124;125 07:08:39 INFO - 2015-12-04 07:08:39,827 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;100;100;100;99;100;102;101;98;99;101 07:08:39 INFO - 2015-12-04 07:08:39,828 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;59;62;62;62;62;63;63;72;57;56 07:08:39 INFO - 2015-12-04 07:08:39,828 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;66;66;66;68;69;68;67;70;68;68 07:08:39 INFO - 2015-12-04 07:08:39,828 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;81;83;83;81;81;81;82;83;82;87 07:08:39 INFO - 2015-12-04 07:08:39,828 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;128;120;120;116;124;127;127;125;124;121 07:08:39 INFO - 2015-12-04 07:08:39,828 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;135;144;144;143;144;134;143;143;142;144 07:08:39 INFO - 2015-12-04 07:08:39,828 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;68;69;68;68;68;67;68;68;69;68 07:08:39 INFO - 2015-12-04 07:08:39,829 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:08:39 INFO - 2015-12-04 07:08:39,829 DEBUG : BROWSER_OUTPUT: __start_cc_report 07:08:39 INFO - 2015-12-04 07:08:39,829 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,884 07:08:39 INFO - 2015-12-04 07:08:39,829 DEBUG : BROWSER_OUTPUT: __end_cc_report 07:08:39 INFO - 2015-12-04 07:08:39,829 DEBUG : BROWSER_OUTPUT: __startTimestamp1449241719823__endTimestamp 07:08:39 INFO - 2015-12-04 07:08:39,829 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,829 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:08:39 INFO - 2015-12-04 07:08:39,830 DEBUG : BROWSER_OUTPUT: Number of tests: 14 07:08:39 INFO - 2015-12-04 07:08:39,830 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,830 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:105.70 Median:110.00 stddev:5.27 (4.8%) stddev-sans-first:5.53 07:08:39 INFO - 2015-12-04 07:08:39,830 DEBUG : BROWSER_OUTPUT: Values: 108.0 110.0 103.0 107.0 110.0 110.0 96.0 108.0 97.0 108.0 07:08:39 INFO - 2015-12-04 07:08:39,830 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,830 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:145.50 Median:153.50 stddev:13.83 (9.0%) stddev-sans-first:14.32 07:08:39 INFO - 2015-12-04 07:08:39,832 DEBUG : BROWSER_OUTPUT: Values: 154.0 128.0 164.0 154.0 129.0 148.0 126.0 159.0 153.0 140.0 07:08:39 INFO - 2015-12-04 07:08:39,832 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,832 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.30 Median:161.50 stddev:0.67 (0.4%) stddev-sans-first:0.71 07:08:39 INFO - 2015-12-04 07:08:39,832 DEBUG : BROWSER_OUTPUT: Values: 161.0 162.0 161.0 161.0 160.0 161.0 162.0 162.0 162.0 161.0 07:08:39 INFO - 2015-12-04 07:08:39,832 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,832 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:82.10 Median:69.00 stddev:21.87 (31.7%) stddev-sans-first:23.20 07:08:39 INFO - 2015-12-04 07:08:39,833 DEBUG : BROWSER_OUTPUT: Values: 82.0 82.0 75.0 124.0 65.0 69.0 69.0 68.0 120.0 67.0 07:08:39 INFO - 2015-12-04 07:08:39,833 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,833 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:103.20 Median:87.00 stddev:20.19 (23.2%) stddev-sans-first:21.38 07:08:39 INFO - 2015-12-04 07:08:39,833 DEBUG : BROWSER_OUTPUT: Values: 100.0 100.0 137.0 87.0 89.0 88.0 127.0 87.0 87.0 130.0 07:08:39 INFO - 2015-12-04 07:08:39,833 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,833 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:118.90 Median:120.00 stddev:2.33 (1.9%) stddev-sans-first:2.44 07:08:39 INFO - 2015-12-04 07:08:39,834 DEBUG : BROWSER_OUTPUT: Values: 120.0 120.0 115.0 120.0 120.0 114.0 120.0 120.0 120.0 120.0 07:08:39 INFO - 2015-12-04 07:08:39,834 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,834 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:124.50 Median:125.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 07:08:39 INFO - 2015-12-04 07:08:39,834 DEBUG : BROWSER_OUTPUT: Values: 125.0 124.0 125.0 125.0 125.0 124.0 124.0 124.0 124.0 125.0 07:08:39 INFO - 2015-12-04 07:08:39,834 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,834 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:100.00 Median:101.50 stddev:1.15 (1.1%) stddev-sans-first:1.22 07:08:39 INFO - 2015-12-04 07:08:39,834 DEBUG : BROWSER_OUTPUT: Values: 100.0 100.0 100.0 99.0 100.0 102.0 101.0 98.0 99.0 101.0 07:08:39 INFO - 2015-12-04 07:08:39,835 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,835 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:61.80 Median:62.00 stddev:4.37 (7.0%) stddev-sans-first:4.51 07:08:39 INFO - 2015-12-04 07:08:39,835 DEBUG : BROWSER_OUTPUT: Values: 59.0 62.0 62.0 62.0 62.0 63.0 63.0 72.0 57.0 56.0 07:08:39 INFO - 2015-12-04 07:08:39,835 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,835 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.60 Median:68.00 stddev:1.35 (2.0%) stddev-sans-first:1.30 07:08:39 INFO - 2015-12-04 07:08:39,836 DEBUG : BROWSER_OUTPUT: Values: 66.0 66.0 66.0 68.0 69.0 68.0 67.0 70.0 68.0 68.0 07:08:39 INFO - 2015-12-04 07:08:39,836 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,836 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:82.40 Median:82.50 stddev:1.84 (2.2%) stddev-sans-first:1.88 07:08:39 INFO - 2015-12-04 07:08:39,836 DEBUG : BROWSER_OUTPUT: Values: 81.0 83.0 83.0 81.0 81.0 81.0 82.0 83.0 82.0 87.0 07:08:39 INFO - 2015-12-04 07:08:39,836 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,836 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:123.20 Median:124.50 stddev:3.85 (3.1%) stddev-sans-first:3.67 07:08:39 INFO - 2015-12-04 07:08:39,837 DEBUG : BROWSER_OUTPUT: Values: 128.0 120.0 120.0 116.0 124.0 127.0 127.0 125.0 124.0 121.0 07:08:39 INFO - 2015-12-04 07:08:39,837 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,837 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:141.60 Median:143.50 stddev:3.81 (2.7%) stddev-sans-first:3.20 07:08:39 INFO - 2015-12-04 07:08:39,837 DEBUG : BROWSER_OUTPUT: Values: 135.0 144.0 144.0 143.0 144.0 134.0 143.0 143.0 142.0 144.0 07:08:39 INFO - 2015-12-04 07:08:39,837 DEBUG : BROWSER_OUTPUT: 07:08:39 INFO - 2015-12-04 07:08:39,838 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.10 Median:68.00 stddev:0.57 (0.8%) stddev-sans-first:0.60 07:08:39 INFO - 2015-12-04 07:08:39,838 DEBUG : BROWSER_OUTPUT: Values: 68.0 69.0 68.0 68.0 68.0 67.0 68.0 68.0 69.0 68.0 07:08:39 INFO - 2015-12-04 07:08:39,839 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:08:39 INFO - 2015-12-04 07:08:39,839 DEBUG : BROWSER_OUTPUT: 07:08:40 INFO - 2015-12-04 07:08:40,388 INFO : Browser exited with error code: 0 07:08:40 INFO - 2015-12-04 07:08:40,438 INFO : Completed test kraken (00:00:56) 07:08:40 INFO - 2015-12-04 07:08:40,439 INFO : Starting test v8_7 07:08:40 INFO - 2015-12-04 07:08:40,439 DEBUG : operating with platform_type : mac_ 07:08:40 INFO - 2015-12-04 07:08:40,439 INFO : Initialising browser for v8_7 test... 07:08:40 INFO - 2015-12-04 07:08:40,451 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/tmpkH1guV/profile http://localhost:61610/getInfo.html 07:08:42 INFO - 2015-12-04 07:08:42,445 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:08:42 INFO - 2015-12-04 07:08:42,445 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:08:42 INFO - 2015-12-04 07:08:42,446 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 07:08:42 INFO - 2015-12-04 07:08:42,446 DEBUG : BROWSER_OUTPUT: __metrics 07:08:42 INFO - 2015-12-04 07:08:42,466 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:08:43 INFO - 2015-12-04 07:08:43,071 INFO : Browser initialized. 07:08:43 INFO - 2015-12-04 07:08:43,071 INFO : Running cycle 1/1 for v8_7 test... 07:08:43 INFO - 2015-12-04 07:08:43,071 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/T/tmpkH1guV/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:08:54 INFO - 2015-12-04 07:08:54,876 DEBUG : BROWSER_OUTPUT: RSS: Main: 199000064 07:08:54 INFO - 2015-12-04 07:08:54,877 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,276 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:61610/tests/v8_7/run.html (next: http://localhost:61610/tests/v8_7/run.html) 07:09:16 INFO - 2015-12-04 07:09:16,538 DEBUG : BROWSER_OUTPUT: RSS: Main: 517894144 07:09:16 INFO - 2015-12-04 07:09:16,538 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,539 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:09:16 INFO - 2015-12-04 07:09:16,539 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:09:16 INFO - 2015-12-04 07:09:16,539 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:09:16 INFO - 2015-12-04 07:09:16,539 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:09:16 INFO - 2015-12-04 07:09:16,539 DEBUG : BROWSER_OUTPUT: |0;Richards;166.08536787908986 07:09:16 INFO - 2015-12-04 07:09:16,539 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;183.18373328448433 07:09:16 INFO - 2015-12-04 07:09:16,540 DEBUG : BROWSER_OUTPUT: |2;Encrypt;320.41012495994875 07:09:16 INFO - 2015-12-04 07:09:16,540 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5731.428571428572 07:09:16 INFO - 2015-12-04 07:09:16,540 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1022.4948875255624 07:09:16 INFO - 2015-12-04 07:09:16,540 DEBUG : BROWSER_OUTPUT: |5;Earley;675.219446320054 07:09:16 INFO - 2015-12-04 07:09:16,540 DEBUG : BROWSER_OUTPUT: |6;Boyer;12456.79012345679 07:09:16 INFO - 2015-12-04 07:09:16,540 DEBUG : BROWSER_OUTPUT: |7;RegExp;29441.176470588234 07:09:16 INFO - 2015-12-04 07:09:16,541 DEBUG : BROWSER_OUTPUT: |8;Splay;578.368999421631 07:09:16 INFO - 2015-12-04 07:09:16,541 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;5797.687861271676 07:09:16 INFO - 2015-12-04 07:09:16,541 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:09:16 INFO - 2015-12-04 07:09:16,541 DEBUG : BROWSER_OUTPUT: __startTimestamp1449241756537__endTimestamp 07:09:16 INFO - 2015-12-04 07:09:16,541 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,541 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:09:16 INFO - 2015-12-04 07:09:16,542 DEBUG : BROWSER_OUTPUT: Number of tests: 10 07:09:16 INFO - 2015-12-04 07:09:16,542 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,543 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:166.09 Median:166.09 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,543 DEBUG : BROWSER_OUTPUT: Values: 166.1 07:09:16 INFO - 2015-12-04 07:09:16,543 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,543 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:183.18 Median:183.18 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,543 DEBUG : BROWSER_OUTPUT: Values: 183.2 07:09:16 INFO - 2015-12-04 07:09:16,543 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,544 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:320.41 Median:320.41 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,544 DEBUG : BROWSER_OUTPUT: Values: 320.4 07:09:16 INFO - 2015-12-04 07:09:16,544 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,544 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5731.43 Median:5731.43 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,544 DEBUG : BROWSER_OUTPUT: Values: 5731.4 07:09:16 INFO - 2015-12-04 07:09:16,544 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,544 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1022.49 Median:1022.49 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,544 DEBUG : BROWSER_OUTPUT: Values: 1022.5 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:675.22 Median:675.22 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: Values: 675.2 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12456.79 Median:12456.79 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: Values: 12456.8 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:29441.18 Median:29441.18 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,545 DEBUG : BROWSER_OUTPUT: Values: 29441.2 07:09:16 INFO - 2015-12-04 07:09:16,546 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,546 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:578.37 Median:578.37 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,546 DEBUG : BROWSER_OUTPUT: Values: 578.4 07:09:16 INFO - 2015-12-04 07:09:16,546 DEBUG : BROWSER_OUTPUT: 07:09:16 INFO - 2015-12-04 07:09:16,546 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:5797.69 Median:5797.69 stddev:0.00 (0.0%) 07:09:16 INFO - 2015-12-04 07:09:16,546 DEBUG : BROWSER_OUTPUT: Values: 5797.7 07:09:16 INFO - 2015-12-04 07:09:16,546 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:09:16 INFO - 2015-12-04 07:09:16,546 DEBUG : BROWSER_OUTPUT: 07:09:17 INFO - 2015-12-04 07:09:17,127 INFO : Browser exited with error code: 0 07:09:17 INFO - 2015-12-04 07:09:17,147 INFO : Completed test v8_7 (00:00:36) 07:09:17 INFO - 2015-12-04 07:09:17,257 INFO : Completed test suite (00:20:08) 07:09:17 INFO - 2015-12-04 07:09:17,257 DEBUG : Working with test: dromaeo_css 07:09:17 INFO - 2015-12-04 07:09:17,257 DEBUG : Generating results file: dromaeo_css 07:09:17 INFO - 2015-12-04 07:09:17,258 DEBUG : Working with test: kraken 07:09:17 INFO - 2015-12-04 07:09:17,258 DEBUG : Generating results file: kraken 07:09:17 INFO - 2015-12-04 07:09:17,258 INFO : javascript benchmark 07:09:17 INFO - 2015-12-04 07:09:17,258 DEBUG : Working with test: v8_7 07:09:17 INFO - 2015-12-04 07:09:17,258 DEBUG : Generating results file: v8_7 07:09:17 INFO - 2015-12-04 07:09:17,259 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:09:17 INFO - 2015-12-04 07:09:17,322 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,52,55]] 07:09:17 INFO - 2015-12-04 07:09:17,322 DEBUG : process_Request line: dromaeo_css 6823.04 graph.html#tests=[[72,52,55]] 07:09:17 INFO - 2015-12-04 07:09:17,322 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:09:17 INFO - 2015-12-04 07:09:17,362 DEBUG : process_Request line: kraken 1485.90 graph.html#tests=[[232,52,55]] 07:09:17 INFO - 2015-12-04 07:09:17,363 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:09:17 INFO - 2015-12-04 07:09:17,394 DEBUG : process_Request line: v8_7 20515.15 graph.html#tests=[[230,52,55]] 07:09:17 INFO - 2015-12-04 07:09:17,395 INFO : javascript benchmark 07:09:17 INFO - 2015-12-04 07:09:17,396 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [361.5264004154558, 362.9691476224521, 366.1724502624072, 369.4827241861395, 373.87662071516405, 15480.612984675388, 15579.92210038951, 17928.64142717145, 18681.0, 19184.520386990316, 15607.921960390211, 18327.633447331045, 18656.160472778723, 18878.244870205177, 18957.0, 4927.866590684145, 5029.06962211992, 5040.647154699154, 5374.731263436823, 5532.1425179097305, 3648.1244501319625, 3738.102855314732, 4952.603791696655, 5026.597872170218, 5062.519060689228, 4960.131976904046, 4999.950000500003, 5001.749912504379, 5001.874953126165, 5005.799768009293, 4879.853604391874, 4992.600591952635, 5000.499950005007, 5028.597712183053, 5042.268871013719, 4316.179925814085, 4327.004788898539, 4328.242557552416, 4329.7618630975285, 4331.6534677225745, 14053.718925621533, 14147.575572732834, 14288.785668214985, 14291.57125286243, 14306.21315827629, 1860.4697661166638, 1997.57052233769, 2009.7387339645898, 2052.0868213644935, 2102.2536999365157, 9796.510174491246, 10138.695839124764, 10184.94907525465, 10242.078212960869, 10587.0, 1650.7523871419264, 1655.7516372544094, 1655.908925009124, 1702.5743564108973, 1757.5606098475382, 55152.72423637896, 56881.43118568803, 57479.0, 57917.0, 58066.129008065334, 6963.1644202696, 6982.092327997328, 7005.334493223136, 7019.929800701928, 7058.470614703918, 8071.0, 8075.152109028468, 8088.0, 8093.595320233965, 8097.311728503143, 5731.312242530839, 5819.76720931158, 5933.080372542263, 5937.9406205937385, 5959.761609535657, 6375.426211640882, 6386.2975072741965, 6420.036994450777, 6428.6785660717715, 6429.9678501607195, 3180.904572862818, 3182.4112539179864, 3187.3784612000436, 3204.9198770030935, 3208.4545627242956, 1077.5582011375297, 1089.0906093411932, 1108.3959242213014, 1143.451143451148, 1151.1423989127986, 428.4173524007347, 437.62364366645295, 440.61006009681665, 455.9863204103882, 458.52542618389805, 11306.773864522664, 11623.360715160577, 11638.592649257236, 11759.118066144902, 11819.054475641928, 406.76610948704615, 419.0968462962321, 422.3116320397732, 428.52433798483656, 442.5684957166737, 5901.439363260483, 6128.754849805958, 6211.068339748984, 6212.751489940351, 6240.563160578716, 590291.0, 626202.0, 631018.0, 633717.0, 633986.0, 78179.60910195412, 78453.60773196098, 78461.60769196232, 78646.21353786503, 79103.23138690119, 468.91325104855713, 471.89382388962207, 472.65496187782423, 472.9125111854318, 473.5383001573507, 11408.201425900439, 11614.593489227836, 11908.583199587973, 11915.940420297842, 11944.2833429991, 36635.0, 37102.25795484129, 39258.2148357037, 39290.60709392984, 39358.0, 49660.503394965584, 50183.74908125436, 51609.0, 51905.0, 52113.7394313026, 8317.126701696236, 8390.07709152005, 8521.403501754818, 8555.786105347415, 8563.486190828571, 12433.254004759743, 12705.36473176356, 12836.486540538273, 12855.678608034874, 12861.614151575468, 9367.484788336435, 9831.31180817336, 10721.088707459954, 10921.235513514295, 11002.229843910849, 9931.304808663614, 9985.400875947467, 10004.899951000396, 10396.324238924446, 10616.513688083829, 10863.293885897392, 10892.782144357227, 10898.673039808818, 10902.291351062155, 10980.780384392108, 8218.260356567938, 8250.752477425447, 8307.0, 8315.459495132796, 8320.583970801557, 10859.83710244331, 10873.401962892116, 11055.889441105486, 11158.107351411705, 11167.497462614365], "dojo.html": [3135.576697145886, 3140.3091319909618, 3156.984215078924, 3161.383530211609, 3184.1721152500345, 5241.082810508165, 5277.788888444457, 5304.0, 5313.867153321164, 5315.840524784253, 5373.059714549948, 5391.083515802313, 5397.433269506704, 5409.972950135254, 5416.0, 4933.901321973567, 4941.308216849644, 4982.501749825006, 5018.498150184989, 5022.723750193738, 5083.364579427572, 5115.744212789365, 5127.2052831811125, 5129.717865517395, 5139.614528910328, 5035.3454050973505, 5059.16523773577, 5064.873378165557, 5078.1874900016, 5079.619028572872, 5016.097102521545, 5049.798008079691, 5088.0332736780265, 5100.1074811907765, 5187.273781670569, 5064.848054558369, 5073.518015788494, 5081.28861959326, 5102.285680004802, 5115.437301896788, 5288.206768984644, 5347.171188465755, 5451.836444906659, 5479.972600137014, 5490.149026900797, 5659.717014149317, 5742.885142297131, 5744.138379243105, 5750.252467179282, 5783.334916484616, 5947.9702601486715, 5953.58324917256, 5976.073708575178, 6006.969965150146, 6017.368176341465, 5306.8407947761625, 5433.809816656477, 5437.293151890308, 5584.246126772915, 5590.832275031756, 5810.622309549865, 5878.764849406061, 5903.203067585821, 5903.616264942765, 5909.497692696169, 5748.0, 5771.538276937835, 5777.884442311214, 5799.420057994167, 5812.244408226903, 5688.431156884361, 5815.04051831443, 5816.79641212564, 5915.08316210988, 5937.554683398676, 5745.597808153389, 5842.8539286517325, 5847.327557330961, 5853.502452291517, 5858.794942177004, 5772.3938986406665, 5781.971090144522, 5784.421557844266, 5786.334571524244, 5801.448862358069, 4416.734995900256, 4469.821207151743, 4503.189425903303, 4505.189065968091, 4531.207038768202, 4099.487564054493, 4151.937720934188, 4160.043190066302, 4169.520505141887, 4175.394567787654, 5507.394186639466, 5512.5314348280845, 5514.283143191359, 5526.336839579196, 5530.751116199781, 5786.768529258867, 5795.246617939725, 5813.12803079533, 5876.823695289148, 5973.253343332083, 5484.780608775604, 5502.972485137549, 5526.557875370041, 5528.364238112588, 5540.750666220029, 5130.846074617767, 5176.844694659167, 5178.896422071537, 5196.948030519647, 5220.086484865134, 5733.71331433435, 5743.74153163117, 5819.912701309399, 5820.272465941757, 5946.345901950782, 5969.492593129633, 5982.940170598238, 5988.221531200916, 5988.401159883977, 6017.548683848817, 6006.549508786771, 6014.518838492822, 6014.939850601438, 6025.367336429612, 6029.547783916136, 5602.803901863578, 5726.341470730753, 5728.312602487728, 5733.254676891977, 5919.644821310563, 5710.17202505626, 5860.179574859609, 5887.20522729426, 5889.646621202742, 5915.171875937458, 5725.828225153252, 5732.856678583069, 5735.627184233012, 5742.138679198154, 5747.4252574742195, 5512.7519261634125, 5627.380988091225, 5657.3776884543495, 5741.5119714824705, 5789.2763404574425, 5623.493885550321, 5648.802291919763, 5656.915146272891, 5660.886782264414, 5671.914921276267, 5752.07966725322, 5770.047942089508, 5796.275465566804, 5807.303123625192, 5810.506106980785, 5465.480779326117, 5558.72206389687, 5583.162525621189, 5676.148577713376, 5685.232493613309], "mootools.html": [1262.545483625895, 1375.346710312601, 1378.4279523997548, 1736.3922627080524, 1837.9632407351853, 7270.200277969419, 7560.0, 7700.922990770091, 7713.922860771398, 7737.767866963986, 7644.923550764491, 7850.136484986647, 7856.332211762007, 7859.135495095535, 7882.369410447165, 2232.8771917544527, 2259.5029093599383, 2264.9660255096187, 2267.2744721689064, 2268.0247493577754, 2296.552172326397, 2300.424893776556, 2342.5666251743396, 2343.50786334869, 2348.635961425982, 2267.920622778203, 2283.04112272845, 2298.6322188449853, 2306.561753266874, 2307.7807608277185, 2247.0337754765446, 2252.9887350563226, 2268.7617800130997, 2268.897899594514, 2271.1596709217697, 2230.475838178027, 2245.4610893385634, 2247.292102987554, 2247.73027236731, 2249.4713742270555, 7096.935459681037, 7250.4199664026755, 7787.143414224431, 7810.843783124305, 7829.41279404047, 4687.812487500496, 4833.9033219335415, 4848.054629347279, 4848.854534363974, 4858.78135483904, 3069.8004629699, 3089.3975674743433, 3138.356636889432, 3138.7802853800245, 3193.96806031939, 911.1617312072909, 929.3866048408019, 933.5658918602883, 958.094600602431, 961.8653388525612, 10209.846852297222, 10297.433641149808, 10316.484175791105, 10331.070203681706, 10334.586616535329, 4128.814203360856, 4139.3583994480905, 4203.726757760735, 4271.530131685512, 4296.2266791977745, 8519.57402129891, 8539.658413663508, 8539.957300213458, 8545.444546104483, 8556.058833528306, 4824.565789079, 4828.806847726122, 4837.516248375205, 4850.393700787402, 4850.587700045536, 4504.459464864171, 4504.594586487166, 4505.098980203907, 4506.954930450654, 4510.007798284372, 3337.6161741399565, 3382.864685412556, 3383.3233353329433, 3391.0, 3417.45320748684, 1043.1967385113421, 1052.7315534538643, 1052.7947050325113, 1055.767731099157, 1063.4257500949554, 987.9506024698736, 1011.0849681038671, 1129.4747942206914, 1337.819394381746, 1339.819124418191, 7339.88990165148, 7504.512206706547, 7534.962325188339, 7546.9245307546225, 7557.697692092364, 470.68228945461675, 475.6313856760969, 481.28529134235635, 481.89157439575814, 482.5777444735856, 5710.7430165642645, 5830.154627578977, 5881.941180588139, 5944.732487038007, 5954.285485741739, 8265.380096492787, 8323.167683231628, 8328.83342333162, 8333.291670207978, 8334.333253339719, 9010.0, 9051.456912585267, 9241.861372079424, 9333.673321433716, 9340.906590934139, 7294.489385743053, 7357.705691772269, 7377.668004939791, 7381.261873812576, 7396.9260307396235, 7256.89114663291, 7294.817629559091, 7345.816354591178, 7367.042284502981, 7378.372838308804, 8204.0, 8278.172182781673, 8326.50040997542, 8346.540940248102, 8401.285890699359, 8325.0, 8487.151284871463, 8490.193431623986, 8573.657053717781, 8597.656093756179, 6672.132622759204, 6745.797626071226, 6750.257471678014, 6751.527393082437, 6758.898616520658, 7364.189939106587, 7585.355244804254, 7598.734044308423, 7611.238876112345, 7617.466777325534, 7096.822579435556, 7119.75080872167, 7162.247963963917, 7210.675519601526, 7224.422046236394, 6860.176778786378, 6894.0, 7019.859602808017, 7100.467464940253, 7114.57312561248, 7103.0, 7124.145102587722, 7206.7117315306805, 7208.315210055036, 7217.855642887218, 6497.0, 6531.052997315268, 6542.640154791532, 6549.672516374258, 6553.279139294578, 6586.1438013058, 6626.237982632059, 6626.602403855592, 6631.0716499689115, 6639.70121344531], "ext.html": [557.381306749508, 590.8345663214299, 593.6972144206454, 599.6042611876161, 599.8500374906273, 32878.34243315132, 40978.0, 41468.792656036756, 41481.792591037, 41529.584704152985, 44244.336334955, 44763.328550071776, 44801.32798008033, 44803.0, 44841.10317793642, 8635.0, 8761.649534018663, 9415.387999780009, 9567.330286879922, 9591.952040239788, 11271.267367621078, 11453.312801231952, 11456.369899655558, 11475.196736228467, 11499.482523286471, 11253.493592788343, 11330.433478326091, 11349.829752553718, 11368.261063030917, 11394.487248073816, 8829.16122968317, 8990.235829954461, 11243.269187502787, 11253.437328133643, 11354.772904541946, 11086.61196858106, 11178.441077946152, 11189.608363707313, 11196.384198869058, 11223.887761122365, 41816.581834181576, 42215.1556968862, 42292.78853605712, 42302.57697423017, 42374.36438453395, 3027.2280568454903, 3108.9067327980197, 3135.6550779414247, 3146.0876345859674, 3161.272907231327, 28986.855065724536, 29104.708952910623, 29454.26364340887, 29717.851410743024, 29733.55399669007, 2385.1771138957033, 2420.140849998243, 2454.9631755523683, 2470.4688491974134, 2529.481456301454, 280497.0, 282023.0, 282251.0, 282336.0, 284792.9999999979, 59592.0, 60895.391046088975, 62239.0, 63427.0, 63435.36564634387, 57792.0, 58243.417565824646, 58431.41568584345, 58441.12338314929, 58668.413315866295, 17892.284308627768, 18096.819031809777, 18099.819001810076, 18100.818991810178, 18119.909400453176, 13934.442622294995, 13953.093048951785, 14024.789628155586, 14255.287235638176, 14261.572152835432, 19808.108635111454, 20075.695079819765, 20078.49803754918, 20083.598328033357, 20097.799022009884, 8933.330000250007, 9098.954505227432, 9101.908980910106, 9110.81778364429, 9118.723378726983, 982.1798798003747, 1005.3967619428284, 1056.271172890703, 1074.4305518075432, 1090.8800031996475, 26174.476510469685, 26682.332941676224, 27721.58417623737, 27966.44067118646, 28117.297067573065, 994.6966175316453, 1090.9672709818717, 1113.821788513834, 1170.011340417346, 1220.1398014399826, 11328.490217940212, 14567.927160364343, 14780.482683106255, 14868.776968345483, 15083.170425626477, 335087.0, 338632.0, 338936.0, 339550.0, 341560.0, 49138.0, 49994.75002624963, 55905.44094559084, 56056.71971640116, 56217.0, 1529.090191336153, 1558.462330495977, 1558.6648870492897, 1568.5686436230128, 1571.7170909236447, 30049.248768780955, 31811.68188318087, 31925.521117183725, 31953.0, 32679.0, 43875.78062109797, 44574.3313850286, 49040.2643960348, 49967.50032499774, 51282.74358628183, 269755.0, 272617.0, 274998.0, 275541.0, 275608.0, 33692.3261534763, 33748.0, 34547.30905381828, 34722.826385867906, 35143.12142196466, 48087.3233432319, 48989.755051224514, 49227.0, 49625.255621166434, 51087.74456127696, 38340.0, 38456.807715961244, 38969.8051509752, 39342.0, 39522.0, 37974.97439995982, 37981.620183798914, 38781.6121838778, 38812.223755525294, 38832.80583597064, 38663.0, 39520.60479395284, 39548.209035819695, 39599.60400395959, 39666.40500392439, 30284.517280513024, 33471.330573388885, 33585.0, 33622.327553448304, 33655.66344336525, 26097.347566310993, 26184.03619728566, 26227.475450491263, 26319.0, 26473.33816654599], "prototype.html": [327.9376918385507, 340.4246822869351, 344.6364085889389, 344.9241166943273, 348.4825034823285, 6163.352847950957, 6227.283862355825, 6236.625802451845, 6313.242410910691, 6322.9051564226575, 6120.326764055962, 6149.81550553483, 6184.536159788011, 6195.659238741868, 6227.221597300338, 4759.595434388072, 4760.4525479569775, 4764.142454358214, 4764.618830493552, 4765.523447655224, 4612.7924243409125, 4705.341252224691, 4714.669973101884, 4768.594669453083, 4789.760511974388, 4704.458987216462, 4738.431388233417, 4739.454962679284, 4768.380110585619, 4776.570108690217, 4731.7634118293945, 4737.976310118462, 4756.7859446325, 4761.2143996240575, 4768.0, 4114.362273847529, 4114.5679703630985, 4124.4019617155345, 4125.855595054189, 4132.73137246081, 5792.160136780185, 6039.758409663608, 6062.666553339564, 6106.694665266719, 6107.786227482017, 5440.075187218183, 5450.5367043801325, 5458.344998600153, 5468.234447177399, 5469.781208751645, 6583.440407565315, 6583.440407565363, 6593.340665933369, 6604.0, 6606.537542372036, 4339.7396156230725, 4437.622802061828, 4541.091781643651, 4549.044700612875, 4551.499335073139, 6613.0, 6671.166104236971, 6702.731890724365, 6802.931970680279, 6822.215445223813, 4449.1101779644205, 4477.798499067485, 4478.708883922534, 4494.10117976406, 4499.055198408306, 4565.223911934979, 4572.634189264851, 4575.107853968444, 4576.908461830745, 4592.97703511487, 5157.974210128926, 5275.683458992473, 5299.602529810202, 5309.867253318621, 5325.3875804282225, 6603.7688680895935, 6605.76879809214, 6608.372204640552, 6619.966900165468, 6654.0, 1633.2650307361735, 1639.3606493467557, 1643.0306119389618, 1643.2276829889934, 1645.9506214813575, 1024.283001898659, 1037.8754549453963, 1065.3980501016902, 1075.7203127186988, 1083.496174278964, 6299.5275354348605, 6299.716512756937, 6306.2747784004505, 6323.430891219812, 6339.429451349401, 6857.588544687334, 6882.69027893736, 6895.75864844728, 6909.136357955255, 6910.2744211858035, 6188.195534580475, 6316.715747791361, 6324.367563243639, 6326.2092238470195, 6328.873422531524, 3757.511523501927, 3786.981065094712, 3797.5442946846556, 3801.429785532137, 3805.5433347997864, 6871.828204294832, 6882.827929301708, 6897.3447522485285, 6901.033855260268, 6918.827029324307, 6868.072810170663, 6972.79081627552, 6990.26602206761, 6991.335823096798, 7028.2620324866175, 6861.416779573692, 6868.244493105754, 6941.028256044056, 6942.548734332252, 6968.0941477607585, 6895.75864844728, 6912.4815638826285, 6913.274106218774, 6925.376716095576, 6946.6179360135675, 6518.152640156939, 6608.603483790988, 6766.8646627068165, 6767.492438067066, 6811.93188068113, 6787.389134977876, 6829.419499342612, 6889.379955804002, 6897.448204143757, 6929.1684997800585, 4431.711938723973, 4498.055408364149, 4509.819607215674, 4515.571020753023, 4517.841875534341, 6632.436242919213, 6788.389044985777, 6799.0, 6803.625800580818, 6809.557378770364, 6596.5052621052655, 6611.404973552403, 6620.304867988792, 6620.66896655175, 6711.395974362135, 6701.296363881722, 6704.027915952257, 6714.3957043866285, 6724.899126513008, 6726.764563240263, 6351.396617321347, 6538.117354157318, 6562.048502967138, 6576.868462630816, 6582.8354291143105, 6709.698063587052, 6712.2616512184595, 6716.5634233774645, 6723.0, 6735.360140786617, 6537.901931470937, 6548.050532672831, 6548.508861835477, 6551.6069035858, 6597.2742998271115], "yui.html": [749.2694622742824, 764.1059959846979, 790.5493868494957, 792.7383963292115, 803.0523981701593, 13842.58472245833, 14234.359453824576, 14244.999999999987, 14246.786298205509, 14276.143431394124, 12478.126531142801, 12480.126391152622, 12482.37588120595, 12976.156549824254, 13461.461541538327, 735.0958321264848, 745.202633182495, 926.8887733471993, 945.1352012908216, 946.8390373636464, 928.5867788833972, 936.8688383626297, 947.2469386837481, 947.5641205045653, 947.6304241345846, 988.0169231614553, 996.5266498413232, 997.0328781082375, 997.5860018092483, 997.675755379501, 788.9526628402314, 800.8358286551272, 960.0927123867948, 977.3549457358181, 992.6525715999414, 724.6376811594203, 724.764451553242, 725.2892165677613, 725.4595326481752, 725.4849057169416, 13898.861011389858, 14084.647883802987, 14092.084014539125, 14094.647633809134, 14124.576262712135, 11265.436728163559, 11320.150988675883, 11355.659330220107, 11590.478428470655, 11697.181197316191, 9334.826694155046, 9626.566804493814, 9647.324687271894, 9672.661456849048, 9755.756106097404, 3358.2108204571905, 3436.244026314207, 3458.515807786912, 3466.6706662866986, 3588.9282214355826, 47850.76074619604, 48226.517734822555, 48318.27522587164, 52330.738346308026, 52758.20862687024, 8878.689245876492, 8950.418222815626, 9226.0, 9432.622695092257, 9441.669541566012, 19721.0, 19744.210231590863, 19771.110300036533, 19781.109850056782, 19799.802001980082, 7055.6119413431725, 7064.0, 7340.926590734024, 7359.4480413968095, 7420.962895185489, 3942.743721658083, 4032.5564187939303, 4038.2529232092156, 4131.400946862748, 4140.0891803803115, 3126.5622812806228, 3150.8582113804932, 3154.369126174774, 3155.100796273051, 3156.542301366335, 429.41813842243937, 432.76414354177047, 436.5765207748479, 451.21038183179434, 453.6325576283221, 488.28466296875246, 575.6718670357856, 602.5270162922172, 610.6702380714364, 626.136736336803, 8045.839083218303, 8052.838943221102, 8074.83850323002, 8090.474119182352, 8233.876491852627, 533.751805410486, 550.2544052808387, 600.8818913330545, 620.965846878417, 627.6736097229415, 3625.4743062255825, 3776.735628506033, 3841.8847434577006, 4072.2873497137884, 4265.594768496988, 59442.702786486654, 59896.401035989955, 60173.69913150494, 64345.35654643487, 64641.03038454427, 51519.48480515222, 51555.22667159996, 51684.48315516872, 55271.0, 55476.0, 48466.757666211444, 49757.99999999927, 50272.497275026784, 50717.0, 50899.49100509022, 8161.0, 8376.53929033909, 8439.28266097364, 8555.61499732501, 8602.225799678059, 37997.81001094977, 38025.61974380331, 38638.420423693104, 38899.416508752955, 38976.6102338973, 45475.545244548455, 50090.2486462696, 50309.74845125751, 50399.49600504095, 50439.74780126076, 7812.3359514439635, 7864.84270314602, 7877.566733829465, 7889.487183333065, 8127.1466496017065, 11253.099752019982, 11551.942240288745, 11555.0, 11595.768084638428, 11620.825687614524, 10201.307656437544, 10352.948235258775, 10410.063094321547, 10449.738756531147, 11187.664370068911, 10897.782044359226, 11027.0075693188, 11165.665030049111, 11236.101111911192, 11243.10055195566, 10363.32638378503, 10459.94770026145, 10670.519826607666, 10774.353538787698, 11211.831822522505, 9413.764655883657, 9604.327697061139, 9668.323217374716, 9866.703998880044, 9952.402855828674, 9306.302027347841, 9429.669961551313, 9436.150746432853, 9443.386179898285, 9589.568469419033]}, "summary": {"suite": 6823.036138574324, "subtests": {"jquery.html": {"filtered": 7124.902470984411, "value": 7124.902470984411}, "dojo.html": {"filtered": 5399.5553103171, "value": 5399.5553103171}, "mootools.html": {"filtered": 4348.679042544405, "value": 4348.679042544405}, "ext.html": {"filtered": 19532.055192441796, "value": 19532.055192441796}, "prototype.html": {"filtered": 4942.023242320133, "value": 4942.023242320133}, "yui.html": {"filtered": 6247.12305641709, "value": 6247.12305641709}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0006"}, "testrun": {"date": 1449240549, "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": "44.0a2", "id": "20151203200703", "branch": "Mozilla-Aurora", "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0"}}, {"talos_counters": {}, "results": {"audio-dft": [161.0, 162.0, 161.0, 161.0, 160.0, 161.0, 162.0, 162.0, 162.0, 161.0], "ai-astar": [108.0, 110.0, 103.0, 107.0, 110.0, 110.0, 96.0, 108.0, 97.0, 108.0], "imaging-gaussian-blur": [120.0, 120.0, 115.0, 120.0, 120.0, 114.0, 120.0, 120.0, 120.0, 120.0], "audio-beat-detection": [154.0, 128.0, 164.0, 154.0, 129.0, 148.0, 126.0, 159.0, 153.0, 140.0], "json-stringify-tinderbox": [66.0, 66.0, 66.0, 68.0, 69.0, 68.0, 67.0, 70.0, 68.0, 68.0], "stanford-crypto-pbkdf2": [135.0, 144.0, 144.0, 143.0, 144.0, 134.0, 143.0, 143.0, 142.0, 144.0], "json-parse-financial": [59.0, 62.0, 62.0, 62.0, 62.0, 63.0, 63.0, 72.0, 57.0, 56.0], "stanford-crypto-sha256-iterative": [68.0, 69.0, 68.0, 68.0, 68.0, 67.0, 68.0, 68.0, 69.0, 68.0], "audio-fft": [82.0, 82.0, 75.0, 124.0, 65.0, 69.0, 69.0, 68.0, 120.0, 67.0], "imaging-darkroom": [125.0, 124.0, 125.0, 125.0, 125.0, 124.0, 124.0, 124.0, 124.0, 125.0], "stanford-crypto-ccm": [128.0, 120.0, 120.0, 116.0, 124.0, 127.0, 127.0, 125.0, 124.0, 121.0], "audio-oscillator": [100.0, 100.0, 137.0, 87.0, 89.0, 88.0, 127.0, 87.0, 87.0, 130.0], "stanford-crypto-aes": [81.0, 83.0, 83.0, 81.0, 81.0, 81.0, 82.0, 83.0, 82.0, 87.0], "imaging-desaturate": [100.0, 100.0, 100.0, 99.0, 100.0, 102.0, 101.0, 98.0, 99.0, 101.0]}, "summary": {"suite": 1485.8999999999999, "subtests": {"audio-fft": {"filtered": 82.1, "value": 82.1}, "stanford-crypto-pbkdf2": {"filtered": 141.6, "value": 141.6}, "audio-beat-detection": {"filtered": 145.5, "value": 145.5}, "stanford-crypto-ccm": {"filtered": 123.2, "value": 123.2}, "imaging-darkroom": {"filtered": 124.5, "value": 124.5}, "json-parse-financial": {"filtered": 61.8, "value": 61.8}, "audio-oscillator": {"filtered": 103.2, "value": 103.2}, "ai-astar": {"filtered": 105.7, "value": 105.7}, "audio-dft": {"filtered": 161.3, "value": 161.3}, "stanford-crypto-sha256-iterative": {"filtered": 68.1, "value": 68.1}, "json-stringify-tinderbox": {"filtered": 67.6, "value": 67.6}, "imaging-gaussian-blur": {"filtered": 118.9, "value": 118.9}, "stanford-crypto-aes": {"filtered": 82.4, "value": 82.4}, "imaging-desaturate": {"filtered": 100.0, "value": 100.0}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0006"}, "testrun": {"date": 1449240549, "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": "44.0a2", "id": "20151203200703", "branch": "Mozilla-Aurora", "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0"}}, {"talos_counters": {}, "results": {"DeltaBlue": [183.18373328448433], "Encrypt": [320.41012495994875], "NavierStokes": [5797.687861271676], "Decrypt": [5731.428571428572], "Splay": [578.368999421631], "Richards": [166.08536787908986], "RegExp": [29441.176470588234], "Earley": [675.219446320054], "Boyer": [12456.79012345679], "RayTrace": [1022.4948875255624]}, "summary": {"suite": 20515.15149389381, "subtests": {"DeltaBlue": {"filtered": 360.9381620000001, "value": 360.9381620000001}, "Encrypt": {"filtered": 830.7509009999997, "value": 830.7509009999997}, "NavierStokes": {"filtered": 255.96410767696923, "value": 255.96410767696923}, "Decrypt": {"filtered": 46.44234795613162, "value": 46.44234795613162}, "Splay": {"filtered": 140.89793900000006, "value": 140.89793900000006}, "RegExp": {"filtered": 30.94254745254745, "value": 30.94254745254745}, "Richards": {"filtered": 212.55334200000007, "value": 212.55334200000007}, "Earley": {"filtered": 987.0317029999998, "value": 987.0317029999998}, "Boyer": {"filtered": 53.501985133795806, "value": 53.501985133795806}, "RayTrace": {"filtered": 723.7092419999998, "value": 723.7092419999998}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0006"}, "testrun": {"date": 1449240549, "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": "44.0a2", "id": "20151203200703", "branch": "Mozilla-Aurora", "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0"}}] 07:09:17 INFO - RETURN: dromaeo_css: 6823.04 07:09:17 INFO - RETURN: kraken: 1485.90 07:09:17 INFO - RETURN: v8_7: 20515.15 07:09:17 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,55]]", "result": "20515.15"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,55]]", "result": "1485.90"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,55]]", "result": "6823.04"}}} 07:09:17 INFO - Return code: 0 07:09:17 INFO - # TBPL SUCCESS # 07:09:17 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 07:09:17 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 07:09:17 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 07:09:17 INFO - 2015-12-04 07:09:17.527 screenresolution[10841:228718] starting screenresolution argv=screenresolution get 07:09:17 INFO - 2015-12-04 07:09:17.531 screenresolution[10841:228718] Display 0: 1600x1200x32@60 07:09:17 INFO - 2015-12-04 07:09:17.537 screenresolution[10842:228721] starting screenresolution argv=screenresolution list 07:09:17 INFO - Available Modes on Display 0 07:09:17 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 07:09:17 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 07:09:17 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 07:09:17 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 07:09:17 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 07:09:17 INFO - Intel HD Graphics 3000: 07:09:17 INFO - Chipset Model: Intel HD Graphics 3000 07:09:17 INFO - Type: GPU 07:09:17 INFO - Bus: Built-In 07:09:17 INFO - VRAM (Total): 512 MB 07:09:17 INFO - VRAM (Dynamic, Max): 10 07:09:17 INFO - Vendor: Intel (0x8086) 07:09:17 INFO - Device ID: 0x0116 07:09:17 INFO - Revision ID: 0x0009 07:09:17 INFO - Displays: 07:09:17 INFO - Display: 07:09:17 INFO - Resolution: 1600 x 1200 @ 60 Hz 07:09:17 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 07:09:17 INFO - Display Serial Number: 1600x1200 60 07:09:17 INFO - Main Display: Yes 07:09:17 INFO - Mirror: Off 07:09:17 INFO - Online: Yes 07:09:17 INFO - Rotation: Supported 07:09:17 INFO - Return code: 0 07:09:17 INFO - Running post-action listener: _resource_record_post_action 07:09:17 INFO - Running post-run listener: _resource_record_post_run 07:09:18 INFO - Total resource usage - Wall time: 1245s; CPU: 30.0%; Read bytes: 8294912; Write bytes: 693231616; Read time: 5390; Write time: 51081 07:09:18 INFO - install - Wall time: 36s; CPU: 30.0%; Read bytes: 342090240; Write bytes: 348520448; Read time: 31865; Write time: 10127 07:09:18 INFO - run-tests - Wall time: 1209s; CPU: 30.0%; Read bytes: 7963136; Write bytes: 342896640; Read time: 4780; Write time: 40892 07:09:18 INFO - Running post-run listener: _upload_blobber_files 07:09:18 INFO - Blob upload gear active. 07:09:18 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 07:09:18 INFO - Copying logs to upload dir... 07:09:18 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1303.920508 ========= master_lag: 5.61 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 49 secs) (at 2015-12-04 07:09:24.520951) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-04 07:09:24.524442) ========= 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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners TMPDIR=/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010259 build_url: 'https://queue.taskcluster.net/v1/task/snPNM1ORRSKG_-NKNZS_dg/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg' ========= master_lag: 0.30 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-04 07:09:24.837623) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 07:09:24.837976) ========= 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.gQevzpIaHP/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.ZYhf7q6tDT/Listeners TMPDIR=/var/folders/qn/0tq7qsfs55z3zcj458fr0sg000000w/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.005529 ========= master_lag: 0.06 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 07:09:24.905874) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-04 07:09:24.906194) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-04 07:09:24.907281) ========= ========= Total master_lag: 6.08 =========