builder: mozilla-central_yosemite_test-dromaeojs slave: t-yosemite-r5-0005 starttime: 1446771336.55 results: success (0) buildid: 20151105145235 builduid: 4d53b6cdac9741e2a167603f6bff314a revision: dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.549914) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.550379) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.550688) ========= 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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners TMPDIR=/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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.006066 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.573698) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.574012) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.589223) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.589643) ========= 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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners TMPDIR=/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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.005419 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.638558) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.638895) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.639268) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.639551) ========= 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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners TMPDIR=/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False --2015-11-05 16:55:36-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 15.8M=0.001s 2015-11-05 16:55:36 (15.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.195264 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.850849) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.851194) ========= 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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners TMPDIR=/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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.019648 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.900772) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:36.901124) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners TMPDIR=/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False 2015-11-05 16:55:36,977 truncating revision to first 12 chars 2015-11-05 16:55:36,977 Setting DEBUG logging. 2015-11-05 16:55:36,977 attempt 1/10 2015-11-05 16:55:36,977 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/dae6c2b8fef8?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-05 16:55:37,633 unpacking tar archive at: mozilla-central-dae6c2b8fef8/testing/mozharness/ program finished with exit code 0 elapsedTime=0.900502 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:37.817878) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:37.818202) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:37.831074) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:37.831520) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-05 16:55:37.832145) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 16 secs) (at 2015-11-05 16:55:37.832584) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners TMPDIR=/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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 16:55:38 INFO - MultiFileLogger online at 20151105 16:55:38 in /builds/slave/test 16:55:38 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 16:55:38 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:55:38 INFO - {'append_to_log': False, 16:55:38 INFO - 'base_work_dir': '/builds/slave/test', 16:55:38 INFO - 'blob_upload_branch': 'Firefox', 16:55:38 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:55:38 INFO - 'branch': 'Firefox', 16:55:38 INFO - 'buildbot_json_path': 'buildprops.json', 16:55:38 INFO - 'config_files': ('talos/mac_config.py',), 16:55:38 INFO - 'default_actions': ('clobber', 16:55:38 INFO - 'read-buildbot-config', 16:55:38 INFO - 'download-and-extract', 16:55:38 INFO - 'populate-webroot', 16:55:38 INFO - 'create-virtualenv', 16:55:38 INFO - 'install', 16:55:38 INFO - 'run-tests'), 16:55:38 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:55:38 INFO - 'download_minidump_stackwalk': True, 16:55:38 INFO - 'download_symbols': 'ondemand', 16:55:38 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:55:38 INFO - 'tooltool.py': '/tools/tooltool.py', 16:55:38 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:55:38 INFO - '/tools/misc-python/virtualenv.py')}, 16:55:38 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:55:38 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:55:38 INFO - 'installer_path': 'installer.exe', 16:55:38 INFO - 'log_level': 'info', 16:55:38 INFO - 'log_name': 'talos', 16:55:38 INFO - 'log_to_console': True, 16:55:38 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 16:55:38 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 16:55:38 INFO - 'opt_config_files': (), 16:55:38 INFO - 'pip_index': False, 16:55:38 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 16:55:38 INFO - 'cmd': ('bash', 16:55:38 INFO - '-c', 16:55:38 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 16:55:38 INFO - 'enabled': True, 16:55:38 INFO - 'halt_on_failure': False, 16:55:38 INFO - 'name': 'check_screen_resolution'},), 16:55:38 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 16:55:38 INFO - 'cmd': ('bash', 16:55:38 INFO - '-c', 16:55:38 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 16:55:38 INFO - 'enabled': True, 16:55:38 INFO - 'halt_on_failure': False, 16:55:38 INFO - 'name': 'check_screen_resolution'},), 16:55:38 INFO - 'run_cmd_checks_enabled': True, 16:55:38 INFO - 'sps_profile': False, 16:55:38 INFO - 'sps_profile_interval': 0, 16:55:38 INFO - 'suite': 'dromaeojs', 16:55:38 INFO - 'system_bits': '64', 16:55:38 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:55:38 INFO - 'title': 't-yosemite-r5-0005', 16:55:38 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:55:38 INFO - 'use_talos_json': True, 16:55:38 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:55:38 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:55:38 INFO - 'work_dir': 'build'} 16:55:38 INFO - ##### 16:55:38 INFO - ##### Running clobber step. 16:55:38 INFO - ##### 16:55:38 INFO - Running pre-action listener: _resource_record_pre_action 16:55:38 INFO - Running main action method: clobber 16:55:38 INFO - rmtree: /builds/slave/test/build 16:55:38 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:55:38 INFO - Running post-action listener: _resource_record_post_action 16:55:38 INFO - ##### 16:55:38 INFO - ##### Running read-buildbot-config step. 16:55:38 INFO - ##### 16:55:38 INFO - Running pre-action listener: _resource_record_pre_action 16:55:38 INFO - Running main action method: read_buildbot_config 16:55:38 INFO - Using buildbot properties: 16:55:38 INFO - { 16:55:38 INFO - "properties": { 16:55:38 INFO - "buildnumber": 579, 16:55:38 INFO - "product": "firefox", 16:55:38 INFO - "script_repo_revision": "production", 16:55:38 INFO - "builddir": "mozilla-central_yosemite_test-dromaeojs", 16:55:38 INFO - "repository": "", 16:55:38 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 mozilla-central talos dromaeojs", 16:55:38 INFO - "buildid": "20151105145235", 16:55:38 INFO - "slavename": "t-yosemite-r5-0005", 16:55:38 INFO - "pgo_build": "False", 16:55:38 INFO - "basedir": "/builds/slave/test", 16:55:38 INFO - "project": "", 16:55:38 INFO - "platform": "yosemite", 16:55:38 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 16:55:38 INFO - "slavebuilddir": "test", 16:55:38 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 16:55:38 INFO - "branch": "mozilla-central", 16:55:38 INFO - "repo_path": "mozilla-central", 16:55:38 INFO - "stage_platform": "macosx64", 16:55:38 INFO - "builduid": "4d53b6cdac9741e2a167603f6bff314a", 16:55:38 INFO - "revision": "dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d" 16:55:38 INFO - }, 16:55:38 INFO - "sourcestamp": { 16:55:38 INFO - "repository": "", 16:55:38 INFO - "hasPatch": false, 16:55:38 INFO - "project": "", 16:55:38 INFO - "branch": "mozilla-central-macosx64-talos", 16:55:38 INFO - "changes": [ 16:55:38 INFO - { 16:55:38 INFO - "category": null, 16:55:38 INFO - "files": [ 16:55:38 INFO - { 16:55:38 INFO - "url": null, 16:55:38 INFO - "name": "https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 16:55:38 INFO - } 16:55:38 INFO - ], 16:55:38 INFO - "repository": "", 16:55:38 INFO - "rev": "dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d", 16:55:38 INFO - "who": "kwierso@gmail.com", 16:55:38 INFO - "when": 1446770735, 16:55:38 INFO - "number": 6627619, 16:55:38 INFO - "comments": "Bumping manifests a=b2g-bump", 16:55:38 INFO - "project": "", 16:55:38 INFO - "at": "Thu 05 Nov 2015 16:45:35", 16:55:38 INFO - "branch": "mozilla-central-macosx64-talos", 16:55:38 INFO - "revlink": "", 16:55:38 INFO - "properties": [ 16:55:38 INFO - [ 16:55:38 INFO - "buildid", 16:55:38 INFO - "20151105145235", 16:55:38 INFO - "Change" 16:55:38 INFO - ], 16:55:38 INFO - [ 16:55:38 INFO - "builduid", 16:55:38 INFO - "4d53b6cdac9741e2a167603f6bff314a", 16:55:38 INFO - "Change" 16:55:38 INFO - ], 16:55:38 INFO - [ 16:55:38 INFO - "pgo_build", 16:55:38 INFO - "False", 16:55:38 INFO - "Change" 16:55:38 INFO - ] 16:55:38 INFO - ], 16:55:38 INFO - "revision": "dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d" 16:55:38 INFO - } 16:55:38 INFO - ], 16:55:38 INFO - "revision": "dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d" 16:55:38 INFO - } 16:55:38 INFO - } 16:55:38 INFO - Found installer url https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 16:55:38 INFO - Running post-action listener: _resource_record_post_action 16:55:38 INFO - ##### 16:55:38 INFO - ##### Running download-and-extract step. 16:55:38 INFO - ##### 16:55:38 INFO - Running pre-action listener: _resource_record_pre_action 16:55:38 INFO - Running main action method: download_and_extract 16:55:38 INFO - mkdir: /builds/slave/test/build/tests 16:55:38 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')]} 16:55:38 INFO - https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 16:55:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/test_packages.json 16:55:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/test_packages.json 16:55:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 16:55:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 16:55:39 INFO - Downloaded 1149 bytes. 16:55:39 INFO - Reading from file /builds/slave/test/build/test_packages.json 16:55:39 INFO - Using the following test package requirements: 16:55:39 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 16:55:39 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:55:39 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 16:55:39 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:55:39 INFO - u'jsshell-mac.zip'], 16:55:39 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:55:39 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 16:55:39 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 16:55:39 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:55:39 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 16:55:39 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:55:39 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 16:55:39 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:55:39 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 16:55:39 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 16:55:39 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:55:39 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 16:55:39 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 16:55:39 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')]} 16:55:39 INFO - https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 16:55:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:55:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:55:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:55:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 16:55:40 INFO - Downloaded 17458668 bytes. 16:55:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 16:55:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:55:40 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 16:55:45 INFO - Return code: 0 16:55:45 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 16:55:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:55:45 INFO - https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 16:55:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:55:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:55:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:55:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 16:55:56 INFO - Downloaded 17458668 bytes. 16:55:56 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 16:55:56 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:55:56 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 16:56:01 INFO - Return code: 0 16:56: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')]} 16:56:01 INFO - https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 16:56:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 16:56:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 16:56:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 16:56:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 16:56:03 INFO - Downloaded 11131307 bytes. 16:56:03 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 16:56:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 16:56:03 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 16:56:03 INFO - Return code: 0 16:56:03 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')]} 16:56:03 INFO - https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 16:56:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 16:56:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 16:56:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 16:56:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 16:56:41 INFO - Downloaded 108682858 bytes. 16:56:41 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 16:56:41 INFO - mkdir: /builds/slave/test/properties 16:56:41 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:56:41 INFO - Writing to file /builds/slave/test/properties/build_url 16:56:41 INFO - Contents: 16:56:41 INFO - build_url:https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 16:56:41 INFO - Running post-action listener: _resource_record_post_action 16:56:41 INFO - Running post-action listener: set_extra_try_arguments 16:56:41 INFO - ##### 16:56:41 INFO - ##### Running populate-webroot step. 16:56:41 INFO - ##### 16:56:41 INFO - Running pre-action listener: _resource_record_pre_action 16:56:41 INFO - Running main action method: populate_webroot 16:56:41 INFO - Guessing talos json url... 16:56:41 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')]} 16:56:41 INFO - https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt matches https://queue.taskcluster.net 16:56:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 16:56:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 16:56:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt to /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 16:56:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.txt'}, attempt #1 16:56:41 INFO - Downloaded 99 bytes. 16:56:41 INFO - Reading from file /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 16:56:41 INFO - Contents: 16:56:41 INFO - 20151105145235 16:56:41 INFO - https://hg.mozilla.org/mozilla-central/rev/dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d 16:56:41 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')]} 16:56:41 INFO - trying https://hg.mozilla.org/mozilla-central/raw-file/dae6c2b8fe/testing/talos/talos.json 16:56:41 INFO - Downloading https://hg.mozilla.org/mozilla-central/raw-file/dae6c2b8fe/testing/talos/talos.json to /builds/slave/test/build/talos.json 16:56:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/mozilla-central/raw-file/dae6c2b8fe/testing/talos/talos.json', 'file_name': '/builds/slave/test/build/talos.json'}, attempt #1 16:56:42 INFO - Downloaded 4264 bytes. 16:56:42 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:56:42 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:56:42 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 16:56:42 INFO - '../fennec_ids.txt'], 16:56:42 INFO - 'tests': ['tcheck2']}, 16:56:42 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:56:42 INFO - '--tppagecycles', 16:56:42 INFO - '7'], 16:56:42 INFO - 'tests': ['tsvgm']}}, 16:56:42 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 16:56:42 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:56:42 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 16:56:42 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 16:56:42 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:56:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:56:42 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:56:42 INFO - 'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:56:42 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:56:42 INFO - 'tests': ['damp', 'tps']}, 16:56:42 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:56:42 INFO - 'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['damp', 'tps']}, 16:56:42 INFO - 'g3': {'tests': ['dromaeo_dom']}, 16:56:42 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:56:42 INFO - 'other': {'tests': ['a11yr', 16:56:42 INFO - 'ts_paint', 16:56:42 INFO - 'tpaint', 16:56:42 INFO - 'sessionrestore', 16:56:42 INFO - 'sessionrestore_no_auto_restore']}, 16:56:42 INFO - 'other-e10s': {'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['a11yr', 16:56:42 INFO - 'ts_paint', 16:56:42 INFO - 'tpaint', 16:56:42 INFO - 'sessionrestore', 16:56:42 INFO - 'sessionrestore_no_auto_restore']}, 16:56:42 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['a11yr', 16:56:42 INFO - 'ts_paint', 16:56:42 INFO - 'tpaint', 16:56:42 INFO - 'sessionrestore', 16:56:42 INFO - 'sessionrestore_no_auto_restore']}, 16:56:42 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['a11yr', 16:56:42 INFO - 'ts_paint', 16:56:42 INFO - 'tpaint', 16:56:42 INFO - 'sessionrestore', 16:56:42 INFO - 'sessionrestore_no_auto_restore']}, 16:56:42 INFO - 'other_l64': {'tests': ['a11yr', 16:56:42 INFO - 'ts_paint', 16:56:42 INFO - 'tpaint', 16:56:42 INFO - 'sessionrestore', 16:56:42 INFO - 'sessionrestore_no_auto_restore']}, 16:56:42 INFO - 'other_nol64': {'tests': ['a11yr', 16:56:42 INFO - 'ts_paint', 16:56:42 INFO - 'tpaint', 16:56:42 INFO - 'sessionrestore', 16:56:42 INFO - 'sessionrestore_no_auto_restore']}, 16:56:42 INFO - 'svgr': {'tests': ['tsvgx', 16:56:42 INFO - 'tsvgr_opacity', 16:56:42 INFO - 'tart', 16:56:42 INFO - 'tscrollx', 16:56:42 INFO - 'cart']}, 16:56:42 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['tsvgx', 16:56:42 INFO - 'tsvgr_opacity', 16:56:42 INFO - 'tart', 16:56:42 INFO - 'tscrollx', 16:56:42 INFO - 'cart']}, 16:56:42 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:56:42 INFO - 'tests': ['tp5o']}, 16:56:42 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:56:42 INFO - 'talos_options': ['--e10s'], 16:56:42 INFO - 'tests': ['tp5o']}, 16:56:42 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:56:42 INFO - 'talos_options': ['--xperf_path', 16:56:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:56:42 INFO - 'tests': ['tp5n']}, 16:56:42 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:56:42 INFO - 'talos_options': ['--e10s', 16:56:42 INFO - '--xperf_path', 16:56:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 16:56:42 INFO - 'C:/slave/talos-data/talos/xperf.config'], 16:56:42 INFO - 'tests': ['tp5n']}}, 16:56:42 INFO - 'talos.zip': {'path': '', 16:56:42 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:56:42 INFO - Running post-action listener: _resource_record_post_action 16:56:42 INFO - ##### 16:56:42 INFO - ##### Running create-virtualenv step. 16:56:42 INFO - ##### 16:56:42 INFO - Running pre-action listener: _resource_record_pre_action 16:56:42 INFO - Running main action method: create_virtualenv 16:56:42 INFO - Creating virtualenv /builds/slave/test/build/venv 16:56:42 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 16:56:42 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:56:42 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:56:42 INFO - Using real prefix '/tools/python27' 16:56:42 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:56:43 INFO - Installing distribute.............................................................................................................................................................................................done. 16:56:46 INFO - Installing pip.................done. 16:56:46 INFO - Return code: 0 16:56:46 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:56:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:56:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:56:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:56:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:56:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c166a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c1d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff22bcd8320>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c11b9f0>, '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 0x10be7acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c0e5990>, '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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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 16:56:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 16:56:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:56:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vxTgoI5Q9O/Render', 16:56:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:56:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:56:46 INFO - 'HOME': '/Users/cltbld', 16:56:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:56:46 INFO - 'LOGNAME': 'cltbld', 16:56:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:56:46 INFO - 'MOZ_NO_REMOTE': '1', 16:56:46 INFO - 'NO_EM_RESTART': '1', 16:56:46 INFO - 'PAGER': '/bin/cat', 16:56:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:56:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:56:46 INFO - 'PWD': '/builds/slave/test', 16:56:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:56:46 INFO - 'SHELL': '/bin/bash', 16:56:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GGMAI5AMvw/Listeners', 16:56:46 INFO - 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/', 16:56:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:56:46 INFO - 'USER': 'cltbld', 16:56:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:56:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:56:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:56:46 INFO - 'XPC_FLAGS': '0x0', 16:56:46 INFO - 'XPC_SERVICE_NAME': '0', 16:56:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:56:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:56:46 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 16:56:46 INFO - Cleaning up... 16:56:46 INFO - Return code: 0 16:56:46 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 16:56:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:56:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:56:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:56:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:56:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c166a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c1d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff22bcd8320>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c11b9f0>, '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 0x10be7acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c0e5990>, '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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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 16:56:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 16:56:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 16:56:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vxTgoI5Q9O/Render', 16:56:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:56:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:56:46 INFO - 'HOME': '/Users/cltbld', 16:56:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:56:46 INFO - 'LOGNAME': 'cltbld', 16:56:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:56:46 INFO - 'MOZ_NO_REMOTE': '1', 16:56:46 INFO - 'NO_EM_RESTART': '1', 16:56:46 INFO - 'PAGER': '/bin/cat', 16:56:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:56:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:56:46 INFO - 'PWD': '/builds/slave/test', 16:56:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:56:46 INFO - 'SHELL': '/bin/bash', 16:56:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GGMAI5AMvw/Listeners', 16:56:46 INFO - 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/', 16:56:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:56:46 INFO - 'USER': 'cltbld', 16:56:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:56:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:56:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:56:46 INFO - 'XPC_FLAGS': '0x0', 16:56:46 INFO - 'XPC_SERVICE_NAME': '0', 16:56:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:56:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:56:47 INFO - Downloading/unpacking psutil>=0.7.1 16:56:47 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 16:56:47 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 16:56:47 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 16:56:47 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 16:56:47 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 16:56:47 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 16:56:49 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 16:56:49 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 16:56:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:56:49 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:56:49 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:56:49 INFO - Installing collected packages: psutil 16:56:49 INFO - Running setup.py install for psutil 16:56:49 INFO - building 'psutil._psutil_osx' extension 16:56:49 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 16:56:49 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 16:56:50 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 16:56:50 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 16:56:50 INFO - building 'psutil._psutil_posix' extension 16:56:50 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 16:56:50 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 16:56:50 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 16:56:50 INFO - ^ 16:56:50 INFO - 1 warning generated. 16:56:50 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 16:56:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:56:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:56:50 INFO - Successfully installed psutil 16:56:50 INFO - Cleaning up... 16:56:50 INFO - Return code: 0 16:56:50 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 16:56:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:56:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:56:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:56:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:56:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c166a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c1d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff22bcd8320>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c11b9f0>, '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 0x10be7acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c0e5990>, '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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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 16:56:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 16:56:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 16:56:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vxTgoI5Q9O/Render', 16:56:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:56:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:56:50 INFO - 'HOME': '/Users/cltbld', 16:56:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:56:50 INFO - 'LOGNAME': 'cltbld', 16:56:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:56:50 INFO - 'MOZ_NO_REMOTE': '1', 16:56:50 INFO - 'NO_EM_RESTART': '1', 16:56:50 INFO - 'PAGER': '/bin/cat', 16:56:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:56:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:56:50 INFO - 'PWD': '/builds/slave/test', 16:56:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:56:50 INFO - 'SHELL': '/bin/bash', 16:56:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GGMAI5AMvw/Listeners', 16:56:50 INFO - 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/', 16:56:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:56:50 INFO - 'USER': 'cltbld', 16:56:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:56:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:56:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:56:50 INFO - 'XPC_FLAGS': '0x0', 16:56:50 INFO - 'XPC_SERVICE_NAME': '0', 16:56:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:56:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:56:50 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 16:56:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:56:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:56:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:56:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:56:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:56:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:56:52 INFO - Downloading mozsystemmonitor-0.0.tar.gz 16:56:52 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 16:56:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:56:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 16:56:53 INFO - Installing collected packages: mozsystemmonitor 16:56:53 INFO - Running setup.py install for mozsystemmonitor 16:56:53 INFO - Successfully installed mozsystemmonitor 16:56:53 INFO - Cleaning up... 16:56:53 INFO - Return code: 0 16:56:53 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:56:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:56:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:56:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:56:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:56:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c166a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c1d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff22bcd8320>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c11b9f0>, '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 0x10be7acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c0e5990>, '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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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 16:56:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 16:56:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 16:56:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vxTgoI5Q9O/Render', 16:56:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:56:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:56:53 INFO - 'HOME': '/Users/cltbld', 16:56:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:56:53 INFO - 'LOGNAME': 'cltbld', 16:56:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:56:53 INFO - 'MOZ_NO_REMOTE': '1', 16:56:53 INFO - 'NO_EM_RESTART': '1', 16:56:53 INFO - 'PAGER': '/bin/cat', 16:56:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:56:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:56:53 INFO - 'PWD': '/builds/slave/test', 16:56:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:56:53 INFO - 'SHELL': '/bin/bash', 16:56:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GGMAI5AMvw/Listeners', 16:56:53 INFO - 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/', 16:56:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:56:53 INFO - 'USER': 'cltbld', 16:56:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:56:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:56:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:56:53 INFO - 'XPC_FLAGS': '0x0', 16:56:53 INFO - 'XPC_SERVICE_NAME': '0', 16:56:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:56:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:56:53 INFO - Downloading/unpacking blobuploader==1.2.4 16:56:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:56:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:56:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:56:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:56:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:56:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:56:55 INFO - Downloading blobuploader-1.2.4.tar.gz 16:56:55 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 16:56:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:56:55 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:56:55 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 16:56:55 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 16:56:55 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 16:56:55 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 16:56:55 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 16:56:55 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 16:56:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 16:56:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:56:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:56:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:56:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:56:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:56:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:56:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:56:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:56:56 INFO - Downloading docopt-0.6.1.tar.gz 16:56:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 16:56:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:56:57 INFO - Installing collected packages: blobuploader, requests, docopt 16:56:57 INFO - Running setup.py install for blobuploader 16:56:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:56:57 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:56:57 INFO - Running setup.py install for requests 16:56:57 INFO - Running setup.py install for docopt 16:56:57 INFO - Successfully installed blobuploader requests docopt 16:56:57 INFO - Cleaning up... 16:56:58 INFO - Return code: 0 16:56:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:56: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')]} 16:56:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:56:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56: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')]} 16:56:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:56:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:56:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c166a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c1d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff22bcd8320>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c11b9f0>, '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 0x10be7acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c0e5990>, '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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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 16:56:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:56:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:56:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vxTgoI5Q9O/Render', 16:56:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:56:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:56:58 INFO - 'HOME': '/Users/cltbld', 16:56:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:56:58 INFO - 'LOGNAME': 'cltbld', 16:56:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:56:58 INFO - 'MOZ_NO_REMOTE': '1', 16:56:58 INFO - 'NO_EM_RESTART': '1', 16:56:58 INFO - 'PAGER': '/bin/cat', 16:56:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:56:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:56:58 INFO - 'PWD': '/builds/slave/test', 16:56:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:56:58 INFO - 'SHELL': '/bin/bash', 16:56:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GGMAI5AMvw/Listeners', 16:56:58 INFO - 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/', 16:56:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:56:58 INFO - 'USER': 'cltbld', 16:56:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:56:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:56:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:56:58 INFO - 'XPC_FLAGS': '0x0', 16:56:58 INFO - 'XPC_SERVICE_NAME': '0', 16:56:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:56:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:56:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:56:58 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-C7GENm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:56:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:56:58 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-umb6q4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:56:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:56:58 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-V5OmyW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:56:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:56:58 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-o67lc0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:56:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:56:58 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-T9bmYV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:56:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:56:58 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-lLkVJ8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:56:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:56:58 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-5aRAfQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:56:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:56:59 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-F1vEZ_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:56:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:56:59 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-LN0WgL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:56:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:56:59 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-i4rXZf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:56:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:56:59 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-zE5EDN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:56:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:56:59 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-cvJvQq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:56:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:56:59 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-kyeOU3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:56:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:56:59 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-ArjPfG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:56:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:56:59 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-10LsFf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:57:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:57:00 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-d445xh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:57:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:57:00 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-1e_hGc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:57:00 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:57:00 INFO - Running setup.py install for manifestparser 16:57:00 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:57:00 INFO - Running setup.py install for mozcrash 16:57:00 INFO - Running setup.py install for mozdebug 16:57:00 INFO - Running setup.py install for mozdevice 16:57:00 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:57:00 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:57:00 INFO - Running setup.py install for mozfile 16:57:01 INFO - Running setup.py install for mozhttpd 16:57:01 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:57:01 INFO - Running setup.py install for mozinfo 16:57:01 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:57:01 INFO - Running setup.py install for mozInstall 16:57:01 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:57:01 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:57:01 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:57:01 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:57:01 INFO - Running setup.py install for mozleak 16:57:01 INFO - Running setup.py install for mozlog 16:57:01 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:57:01 INFO - Running setup.py install for moznetwork 16:57:02 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:57:02 INFO - Running setup.py install for mozprocess 16:57:02 INFO - Running setup.py install for mozprofile 16:57:02 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:57:02 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:57:02 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:57:02 INFO - Running setup.py install for mozrunner 16:57:02 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:57:02 INFO - Running setup.py install for mozscreenshot 16:57:02 INFO - Running setup.py install for moztest 16:57:02 INFO - Running setup.py install for mozversion 16:57:03 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:57:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:57:03 INFO - Cleaning up... 16:57:03 INFO - Return code: 0 16:57:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:57:03 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')]} 16:57:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:57:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:57:03 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')]} 16:57:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:57:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:57:03 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 0x10c166a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c1d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff22bcd8320>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c11b9f0>, '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 0x10be7acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c0e5990>, '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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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 16:57:03 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 16:57:03 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 16:57:03 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vxTgoI5Q9O/Render', 16:57:03 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:57:03 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:57:03 INFO - 'HOME': '/Users/cltbld', 16:57:03 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:57:03 INFO - 'LOGNAME': 'cltbld', 16:57:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:57:03 INFO - 'MOZ_NO_REMOTE': '1', 16:57:03 INFO - 'NO_EM_RESTART': '1', 16:57:03 INFO - 'PAGER': '/bin/cat', 16:57:03 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:57:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:57:03 INFO - 'PWD': '/builds/slave/test', 16:57:03 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:57:03 INFO - 'SHELL': '/bin/bash', 16:57:03 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GGMAI5AMvw/Listeners', 16:57:03 INFO - 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/', 16:57:03 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:57:03 INFO - 'USER': 'cltbld', 16:57:03 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:57:03 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:57:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:57:03 INFO - 'XPC_FLAGS': '0x0', 16:57:03 INFO - 'XPC_SERVICE_NAME': '0', 16:57:03 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:57:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:57:03 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-bUF2YW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:57:03 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)) 16:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:57:03 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-ybjuRB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:57:03 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)) 16:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:57:03 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-RWZhJs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:57:03 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)) 16:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:57:03 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-uNiAQE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:57:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:57:03 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-9S82ij-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:57:03 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)) 16:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:57:03 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-OtQSil-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:57:04 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)) 16:57:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:57:04 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-fiteFV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:57:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 16:57:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:57:04 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-HTKLZ_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:57:04 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)) 16:57:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:57:04 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-lr4ACS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:57:04 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)) 16:57:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:57:04 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-5a4AW5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:57:04 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)) 16:57:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:57:04 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-amEKDn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:57:04 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)) 16:57:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:57:04 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-jbGita-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:57:04 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)) 16:57:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:57:04 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-SQ0b7G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:57:04 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)) 16:57:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:57:04 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-pDcHJs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:57:05 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)) 16:57:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:57:05 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-IZm1fe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:57:05 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)) 16:57:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:57:05 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-rqzCL2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:57:05 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)) 16:57:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:57:05 INFO - Running setup.py (path:/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/pip-3Hsm2p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:57:05 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)) 16:57:05 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)) 16:57:05 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)) 16:57:05 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)) 16:57:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:57:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:57:05 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:57:05 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 16:57:05 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 16:57:05 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 16:57:05 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 16:57:05 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 16:57:05 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 16:57:07 INFO - Downloading blessings-1.5.1.tar.gz 16:57:07 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 16:57:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:57:07 INFO - Installing collected packages: blessings 16:57:07 INFO - Running setup.py install for blessings 16:57:07 INFO - Successfully installed blessings 16:57:07 INFO - Cleaning up... 16:57:08 INFO - Return code: 0 16:57:08 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:57:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:57:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:57:08 INFO - Reading from file tmpfile_stdout 16:57:08 INFO - Current package versions: 16:57:08 INFO - blessings == 1.5.1 16:57:08 INFO - blobuploader == 1.2.4 16:57:08 INFO - docopt == 0.6.1 16:57:08 INFO - manifestparser == 1.1 16:57:08 INFO - mozInstall == 1.12 16:57:08 INFO - mozcrash == 0.16 16:57:08 INFO - mozdebug == 0.1 16:57:08 INFO - mozdevice == 0.47 16:57:08 INFO - mozfile == 1.2 16:57:08 INFO - mozhttpd == 0.7 16:57:08 INFO - mozinfo == 0.9 16:57:08 INFO - mozleak == 0.1 16:57:08 INFO - mozlog == 3.0 16:57:08 INFO - moznetwork == 0.27 16:57:08 INFO - mozprocess == 0.22 16:57:08 INFO - mozprofile == 0.27 16:57:08 INFO - mozrunner == 6.11 16:57:08 INFO - mozscreenshot == 0.1 16:57:08 INFO - mozsystemmonitor == 0.0 16:57:08 INFO - moztest == 0.7 16:57:08 INFO - mozversion == 1.4 16:57:08 INFO - psutil == 3.1.1 16:57:08 INFO - requests == 1.2.3 16:57:08 INFO - wsgiref == 0.1.2 16:57:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:57: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')]} 16:57:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:57:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:57: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')]} 16:57:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:57:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:57: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', '-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 0x10c166a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c1d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff22bcd8320>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c11b9f0>, '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 0x10be7acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c0e5990>, '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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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 16:57:08 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 16:57:08 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 16:57:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vxTgoI5Q9O/Render', 16:57:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:57:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:57:08 INFO - 'HOME': '/Users/cltbld', 16:57:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:57:08 INFO - 'LOGNAME': 'cltbld', 16:57:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:57:08 INFO - 'MOZ_NO_REMOTE': '1', 16:57:08 INFO - 'NO_EM_RESTART': '1', 16:57:08 INFO - 'PAGER': '/bin/cat', 16:57:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:57:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:57:08 INFO - 'PWD': '/builds/slave/test', 16:57:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:57:08 INFO - 'SHELL': '/bin/bash', 16:57:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GGMAI5AMvw/Listeners', 16:57:08 INFO - 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/', 16:57:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:57:08 INFO - 'USER': 'cltbld', 16:57:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:57:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:57:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:57:08 INFO - 'XPC_FLAGS': '0x0', 16:57:08 INFO - 'XPC_SERVICE_NAME': '0', 16:57:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:57:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 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)) 16:57:08 INFO - Cleaning up... 16:57:08 INFO - Return code: 0 16:57:08 INFO - Running post-action listener: _resource_record_post_action 16:57:08 INFO - Running post-action listener: _start_resource_monitoring 16:57:08 INFO - Starting resource monitoring. 16:57:08 INFO - ##### 16:57:08 INFO - ##### Running install step. 16:57:08 INFO - ##### 16:57:08 INFO - Running pre-action listener: _resource_record_pre_action 16:57:08 INFO - Running main action method: install 16:57:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:57:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:57:08 INFO - Reading from file tmpfile_stdout 16:57:08 INFO - Detecting whether we're running mozinstall >=1.0... 16:57:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:57:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:57:09 INFO - Reading from file tmpfile_stdout 16:57:09 INFO - Output received: 16:57:09 INFO - Usage: mozinstall [options] installer 16:57:09 INFO - Options: 16:57:09 INFO - -h, --help show this help message and exit 16:57:09 INFO - -d DEST, --destination=DEST 16:57:09 INFO - Directory to install application into. [default: 16:57:09 INFO - "/builds/slave/test"] 16:57:09 INFO - --app=APP Application being installed. [default: firefox] 16:57:09 INFO - mkdir: /builds/slave/test/build/application 16:57:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 16:57:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 16:57:44 INFO - Reading from file tmpfile_stdout 16:57:44 INFO - Output received: 16:57:44 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 16:57:44 INFO - Running post-action listener: _resource_record_post_action 16:57:44 INFO - ##### 16:57:44 INFO - ##### Running run-tests step. 16:57:44 INFO - ##### 16:57:44 INFO - Running pre-action listener: _resource_record_pre_action 16:57:44 INFO - Running main action method: run_tests 16:57:44 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:57:44 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:57:44 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:57:44 INFO - 2015-11-05 16:57:44.304 screenresolution[6407:117963] starting screenresolution argv=screenresolution get 16:57:44 INFO - 2015-11-05 16:57:44.307 screenresolution[6407:117963] Display 0: 1600x1200x32@60 16:57:44 INFO - 2015-11-05 16:57:44.313 screenresolution[6408:117965] starting screenresolution argv=screenresolution list 16:57:44 INFO - Available Modes on Display 0 16:57:44 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:57:44 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:57:44 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:57:44 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:57:44 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:57:44 INFO - Intel HD Graphics 3000: 16:57:44 INFO - Chipset Model: Intel HD Graphics 3000 16:57:44 INFO - Type: GPU 16:57:44 INFO - Bus: Built-In 16:57:44 INFO - VRAM (Total): 512 MB 16:57:44 INFO - VRAM (Dynamic, Max): 10 16:57:44 INFO - Vendor: Intel (0x8086) 16:57:44 INFO - Device ID: 0x0116 16:57:44 INFO - Revision ID: 0x0009 16:57:44 INFO - Displays: 16:57:44 INFO - Display: 16:57:44 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:57:44 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:57:44 INFO - Display Serial Number: 1600x1200 60 16:57:44 INFO - Main Display: Yes 16:57:44 INFO - Mirror: Off 16:57:44 INFO - Online: Yes 16:57:44 INFO - Rotation: Supported 16:57:44 INFO - Return code: 0 16:57:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:57:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:57:44 INFO - Python 2.7.3 16:57:44 INFO - Return code: 0 16:57:44 INFO - grabbing minidump binary from tooltool 16:57:44 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')]} 16:57:44 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 0x10c11b9f0>, '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 0x10be7acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c0e5990>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:57:44 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 16:57:44 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 16:57:44 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:57:44 INFO - Return code: 0 16:57:44 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 16:57:44 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:57:44 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:57:44 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 16:57:44 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:57:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0005', '--webServer', 'localhost'] in /builds/slave/test/build 16:57:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0005 --webServer localhost 16:57:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.vxTgoI5Q9O/Render', 16:57:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:57:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:57:44 INFO - 'HOME': '/Users/cltbld', 16:57:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:57:44 INFO - 'LOGNAME': 'cltbld', 16:57:44 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:57:44 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 16:57:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:57:44 INFO - 'MOZ_NO_REMOTE': '1', 16:57:44 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:57:44 INFO - 'NO_EM_RESTART': '1', 16:57:44 INFO - 'PAGER': '/bin/cat', 16:57:44 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:57:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:57:44 INFO - 'PWD': '/builds/slave/test', 16:57:44 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:57:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:57:44 INFO - 'SHELL': '/bin/bash', 16:57:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GGMAI5AMvw/Listeners', 16:57:44 INFO - 'TMPDIR': '/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/', 16:57:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:57:44 INFO - 'USER': 'cltbld', 16:57:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:57:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:57:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:57:44 INFO - 'XPC_FLAGS': '0x0', 16:57:44 INFO - 'XPC_SERVICE_NAME': '0', 16:57:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:57:44 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0005', '--webServer', 'localhost'] with output_timeout 3600 16:57:44 INFO - mozversion INFO | application_buildid: 20151105145235 16:57:44 INFO - mozversion INFO | application_changeset: dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d 16:57:44 INFO - mozversion INFO | application_display_name: Nightly 16:57:44 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:57:44 INFO - mozversion INFO | application_name: Firefox 16:57:44 INFO - mozversion INFO | application_remotingname: firefox 16:57:44 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/mozilla-central 16:57:44 INFO - mozversion INFO | application_vendor: Mozilla 16:57:44 INFO - mozversion INFO | application_version: 45.0a1 16:57:44 INFO - mozversion INFO | platform_buildid: 20151105145235 16:57:44 INFO - mozversion INFO | platform_changeset: dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d 16:57:44 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/mozilla-central 16:57:44 INFO - mozversion INFO | platform_version: 45.0a1 16:57:44 INFO - 2015-11-05 16:57:44,889 DEBUG : using testdate: 1446771464 16:57:44 INFO - 2015-11-05 16:57:44,889 DEBUG : actual date: 1446771464 16:57:44 INFO - 2015-11-05 16:57:44,903 INFO : starting webserver on 'localhost:58116' 16:57:44 INFO - 2015-11-05 16:57:44,904 INFO : Starting test suite t-yosemite-r5-0005 16:57:44 INFO - 2015-11-05 16:57:44,904 INFO : Starting test dromaeo_css 16:57:44 INFO - 2015-11-05 16:57:44,904 DEBUG : operating with platform_type : mac_ 16:57:44 INFO - 2015-11-05 16:57:44,905 INFO : Initialising browser for dromaeo_css test... 16:57:44 INFO - 2015-11-05 16:57:44,918 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/tmpgk60Cz/profile http://localhost:58116/getInfo.html 16:57:47 INFO - 2015-11-05 16:57:47,060 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:57:47 INFO - 2015-11-05 16:57:47,060 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:57:47 INFO - 2015-11-05 16:57:47,060 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:57:47 INFO - 2015-11-05 16:57:47,060 DEBUG : BROWSER_OUTPUT: __metrics 16:57:47 INFO - 2015-11-05 16:57:47,076 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:57:47 INFO - 2015-11-05 16:57:47,705 INFO : Browser initialized. 16:57:47 INFO - 2015-11-05 16:57:47,706 INFO : Running cycle 1/1 for dromaeo_css test... 16:57:47 INFO - 2015-11-05 16:57:47,706 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/tmpgk60Cz/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:57:59 INFO - 2015-11-05 16:57:59,540 DEBUG : BROWSER_OUTPUT: RSS: Main: 221605888 16:57:59 INFO - 2015-11-05 16:57:59,541 DEBUG : BROWSER_OUTPUT: 16:58:50 INFO - 2015-11-05 16:58:50,434 DEBUG : BROWSER_OUTPUT: 1446771530433 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] 17:01:01 INFO - 2015-11-05 17:01:01,063 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58116/tests/dromaeo/cssquery-ext.html) 17:01:02 INFO - 2015-11-05 17:01:02,947 DEBUG : BROWSER_OUTPUT: RSS: Main: 417058816 17:01:02 INFO - 2015-11-05 17:01:02,947 DEBUG : BROWSER_OUTPUT: 17:04:05 INFO - 2015-11-05 17:04:05,730 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/dromaeo/cssquery-ext.html (next: http://localhost:58116/tests/dromaeo/cssquery-jquery.html) 17:04:06 INFO - 2015-11-05 17:04:06,312 DEBUG : BROWSER_OUTPUT: RSS: Main: 367853568 17:04:06 INFO - 2015-11-05 17:04:06,313 DEBUG : BROWSER_OUTPUT: 17:07:08 INFO - 2015-11-05 17:07:08,303 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58116/tests/dromaeo/cssquery-mootools.html) 17:07:08 INFO - 2015-11-05 17:07:08,886 DEBUG : BROWSER_OUTPUT: RSS: Main: 333803520 17:07:08 INFO - 2015-11-05 17:07:08,886 DEBUG : BROWSER_OUTPUT: 17:10:10 INFO - 2015-11-05 17:10:10,787 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58116/tests/dromaeo/cssquery-prototype.html) 17:10:11 INFO - 2015-11-05 17:10:11,362 DEBUG : BROWSER_OUTPUT: RSS: Main: 324808704 17:10:11 INFO - 2015-11-05 17:10:11,362 DEBUG : BROWSER_OUTPUT: 17:13:14 INFO - 2015-11-05 17:13:14,198 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58116/tests/dromaeo/cssquery-yui.html) 17:13:14 INFO - 2015-11-05 17:13:14,804 DEBUG : BROWSER_OUTPUT: RSS: Main: 322392064 17:13:14 INFO - 2015-11-05 17:13:14,804 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,639 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/dromaeo/cssquery-yui.html (next: http://localhost:58116/tests/dromaeo/cssquery-dojo.html) 17:16:17 INFO - 2015-11-05 17:16:17,895 DEBUG : BROWSER_OUTPUT: RSS: Main: 399552512 17:16:17 INFO - 2015-11-05 17:16:17,895 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,896 DEBUG : BROWSER_OUTPUT: __start_tp_report 17:16:17 INFO - 2015-11-05 17:16:17,896 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 17:16:17 INFO - 2015-11-05 17:16:17,896 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 17:16:17 INFO - 2015-11-05 17:16:17,897 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 17:16:17 INFO - 2015-11-05 17:16:17,898 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3163.478026125689;3198.088544764741;3216.7104960553547;3227.7579181561387;3260.8695652173915;5123.641345105835;5261.973690131554;5324.920126198105;5341.839744807662;5345.091334473139;5365.3293338332705;5372.355317361912;5428.240046393508;5431.293931788862;5555.861103472415;4931.408231012284;4970.6023518118645;4999;5015.122353588125;5076;5017.824376146836;5172.741362931857;5172.9224061638915;5178.896422071575;5181.196914478243;4738.549837765407;4815.66290359675;4863.27050942358;4982.800687972477;5106.183010718304;4972.353594032753;4978.377702787152;4979.651424400294;4986.227134794112;5020.1214787412055;4935.161022626162;4936.160852655057;4943.209086546135;4966.47851975541;4998.025385049917;5118.795248190068;5199.766010529535;5227.712475813829;5297.629165958385;5441.319835020622;5665.433456654301;5686;5689.146628005791;5692.6299790513895;5702.971485142548;5745.597808153431;5747.741351639186;5750.252467179282;5758.193852860602;5764.855878603026;5289.735513224324;5289.947100528984;5366.7048312343195;5401.189821526802;5406.08096623575;5863.5309175265875;5880.647161170258;5924.259467566554;5933.495652869555;5935.376785437553;5646.943530564642;5652.406497317805;5660.349059858087;5685.545156387479;5701.258836351248;5409.5672346213;5477.096279113981;5479.150731636602;5492.5605951523785;5498.725063746797;5555.972220138954;5574.16387541872;5633.380328163898;5717;5760.049591817303;5566.2207290979295;5594.608377413542;5602.411746766612;5605.523530499953;5609.943900561024;4400.405945197422;4404.4494438195225;4413.955860441354;4415.1611193873705;4435.223835828717;3958.3666613342302;4018;4053.9594604054173;4058.9188216236103;4076.673866090706;5312.814051508179;5325.3609566851455;5329.973350133225;5336.146216605324;5358.705271210043;5814.592978491465;5831.06702927538;5840.5035571976005;5845;5856.824295271149;5423.945760542423;5449.64577302482;5463.535599474009;5470.234167216593;5472.042392581282;5080.822171224063;5091.287219789232;5094.312267843868;5099.515546023122;5099.796008159632;5896.705164741746;5908;5916;5917.704114794329;5927.614705044159;5785.161151633074;5786.132080188006;5858.384869588632;5873.2658417697785;5896.056630939029;5938.881222375442;5945.137954996588;5957.4042595740075;5979.282486101695;5982.192404025575;5464.890702185855;5549.445055494418;5554.722263886871;5766.3368712598585;5766.94233057664;5745.2818397700285;5788.421157884178;5790.826275211751;5792.420757924174;5827.475527202572;5619.185218143428;5677.687727175045;5726.627769194989;5729.197912292199;5731.799387021434;5435;5534.584906132137;5554.944450555443;5702;5708.058170402003;5467.808626698046;5474.0146773579545;5475.780968761205;5479.0411677957;5482.753276102505;5648.322201335702;5675.659460432387;5685.118806584986;5693.4875861172695;5702.230198923092;5547.001539722727;5559.19391688211;5577.693226872561;5580.386157522588;5583.134614134816 17:16:17 INFO - 2015-11-05 17:16:17,901 DEBUG : BROWSER_OUTPUT: |1;ext.html;574.4800955135603;578.675941472775;584.0713265907208;586.2964442668796;588.9911651325228;32533.83733081334;32970.17574560634;41321.38017929733;42131.78934105325;42147.57852421483;43875.56124438762;44359.112817743626;44360.11279774403;44394.33408498867;44433.111337773225;8330.50016998982;9385.061493850611;9529.237660987104;9582.760430989247;9582.904170958305;8488.23605875471;11268;11488.655340339803;11498.597549085784;11507.654770356903;11166.385848778315;11324.547018119265;11325.830112548318;11332.603358882441;11361.091112710963;8460.323174146053;8617.56912154396;11197;11267.323960562351;11364.488598013026;10906.836397454044;10999.505022274017;11016.669499915015;11044.226904116715;11068.114550835913;41196;41689.791551042355;41753;41782.37326440106;41820.372694409605;2947.911562653124;2996.7752418568693;3002.894898678536;3009.8043627164166;3113.143885431502;28025.43949121006;28074;28255.717442825513;28360;28552.857235713895;2345.6950596422525;2363.279199844047;2408.0728919365997;2408.903643854261;2505.5114252720728;297223;302015;302376;303093;303762;57675;58924.41075589275;61723.691381542805;62325;62412;60670;61260.387396125465;61567.69216153891;61629.69185154135;61679.07481387783;16998.405055822986;17225.1387430628;17235.91382043082;17237.224324905408;17242.568935776704;12073.396330183456;12099.939500302442;12106.636800895987;12109.818352724717;12115.939420302842;20665.17339306411;21474.463138421354;21531.13875444996;21615.891920540296;21665.78334216669;9115.951665558414;9428.575714092882;9434.90565094354;9444.574994125282;9450.810983780286;924.2882980105416;1050.3540322701483;1052.6631477927142;1101.944902754859;1115.2304909612342;29305.267368315537;29791;29941.251468713457;32262.838685806422;33520.66479335175;1020.6274709731043;1083.978320433587;1088.6283283063397;1098.7637657903429;1170.9941450292865;15241.6189595261;15423.383064677288;15561.221938903009;15623.3750649975;15644.68710625781;363498;369326;369436;370319;371742;57299.71350143223;57883.421165787804;57892.71053644705;57911.420885790605;57992.42007579954;1407.1275808998282;1416.2847761880184;1417.4684493315008;1417.9361928713233;1436.590571687085;29486.705132948395;29956.550651740676;32955.8352208247;33224.66775332216;33327.33345333128;54445.1833222494;54986;55056.17415738687;55058;55082;289900.2019959631;293417;293674;294774;295137;39217.41173882337;40069.39895901505;43349;44300.33549496696;44906.77546612246;42430.151396972506;43427.565724343614;44426.55573444354;45034.3244851334;45875;36760.81619591992;37994.81002594969;38847.6115238844;38887.222255555294;38963;35636.821815890755;37214.62785372112;40742.79628601838;41386.37920431136;41867;37638.24723505569;38078.80960595179;38801.417978729776;38838.029049273995;38887.61112388953;31823;33899;34063;34070.82964585161;34084.31831363408;25426.872865635552;25834.35414114662;25858.61212081858;25868.611970820828;26121.346966325993 17:16:17 INFO - 2015-11-05 17:16:17,902 DEBUG : BROWSER_OUTPUT: |2;jquery.html;339.0100905356359;341.5099332457921;344.4832750873689;344.77417291673964;350.83510749947516;14567.92716036421;14970.625734356647;16983.83016169838;17130.743038854413;17592;14442.638934026654;15614.76577851333;17622.735658965124;18009.4597162085;18224.908875455636;5300.681959082467;5438.238646589481;5452.6183167178315;5456.427075157111;5456.590755693319;3928.3321835287925;4052.49343832021;5274.367075950891;5422.75597598107;5453.563714902818;5781.421857814227;5855.23881895353;5942.316633587128;5962.97018514909;5973.4623883850445;5788.305403351604;5924.49641780447;5932.3474417814;5947.494462970652;5949.464548190662;5118.718470484122;5119.10415677255;5119.923201151985;5120.615953803443;5132.640715149941;21579.67630485544;21999.12003519857;22315.44211394712;22359.441013974618;22390.104395824146;1939.5732938753451;2037.6739721644465;2047.580246049571;2099.454141923111;2175.216921908112;13488.86511134886;13670.657374868513;13732.931335343359;13744.587662370144;13763.518276860263;1677.2787701288441;1692.5683950592643;1699.2013753535819;1706.121347506023;1749.8862573932781;58652.12021819676;59027;59544.70227648834;59723.701381492814;60549.69725151346;9454.952725236468;9644.276679249084;9812.362196457207;9832.410055396556;9888.65389711371;11927.701807454883;11949.820752688716;11958.16292859509;11970.700732481757;11973.281603103842;5131.897362052738;5142.768575414116;5145.4854514549;5377.193420986883;8218.712345067894;5855.033919403336;5855.824325270163;5856.209411729447;5868.530517558585;5903.173555702205;2743;2768.9030883919368;2772.2514920971225;2784.721527847199;2788.6514185726783;963.8168747938009;990.9900900990898;1000.0049950299499;1015.7663737340453;1047.3297089862494;408.5159086482468;412.190046558514;417.14485305124373;433.4863187123269;438.02757877511874;10951.4524273786;11249.775004499865;11391.601293954838;11652.475638596283;11740.882591173979;422.6513126670509;430.86427775250695;444.957729015743;445.0209539014117;445.06314208591095;5520.641158324696;6035.396460354017;6114.5414093942245;6130.356312587203;6132.816015519542;524562;527890;543226;564094;565582;70438;70846;71980.64009679918;73259;77349;471.886747180681;479.51089888313726;480.8990112076503;481.08833760024555;481.814501416957;10693.8930610696;10782.353058816496;10805.783884322427;10857.34855908648;10880.238383313408;36504.63495365012;36898.26203475969;37074.81462592778;37076;37243.25513489769;48774.268385973526;49551.752241238566;49739.25391119064;50136.49863501318;50237.24644130414;7267.890981635174;7336.266373362834;7382;7433.553986760811;7439.442041846775;11420.714482138013;11509.36698481558;11514.712132196762;11514.712132196762;11523;9528;9600.231981441608;10006.499675016075;10011.849822252527;10044.347117437343;9585.472798996123;9646.42121472714;9656.324057316202;9661.420314781135;9850.556724947537;9876.506174691092;9985.850212246676;9988.450635215133;10009.399436033862;10036.247281454067;7074.115735533059;7420.072490938633;7483.700651974078;7488.063992001;7507.924920750941;9723.951380243336;9914.40513569188;9996.150327221976;10006;10015.048570385801 17:16:17 INFO - 2015-11-05 17:16:17,905 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1273.7643535945845;1454.6872422429178;1525.2221367102775;1692.7122389193835;1837.2008176443248;7040.436765058796;7515.736949206779;7622.77131686049;7647.158812530631;7654.081510218782;7315.5244909080875;7634;7648.120466146394;7650.158482566913;7657.578833164173;2153.7092492513507;2169.197396963126;2174.847760656755;2174.8912554372296;2176.847620666554;2141.1970511058353;2143.228437762404;2262.671912572676;2268.138107519149;2270.4550907782177;2169.978300217001;2194.4075099723063;2197.044285735702;2201.2955854126685;2206.9668954965687;2149.1403438624598;2153.3432303147533;2155.2025750472267;2155.698202251686;2161.578492194015;2144.1959265275523;2182.7817218278205;2182.978170218309;2185.715856938604;2186.726659167604;6768.932310676929;6923.930760692429;7520.661570229353;7561.7731468056045;7563.394928405714;4538.704984176018;4650.86047418578;4653.208954477747;4668.50980647034;4670.789814458358;2780.666320041588;2807.6069350290977;2850.3016760893506;2855.0435604072454;2902.129361191634;840.2815592668303;852.403317677622;854.3976496569966;861.5218553702692;865.7532603208056;9952.253580981456;9992.95003524985;10001.249906256988;10009.099181073738;10017.449040302781;4159.75041497505;4202.579742025773;4208.116295577902;4208.915821683549;4343.82624695015;8839.646414143492;8840;8843.380963332633;8852.070532594114;8863.290936725047;4821.614270858323;4821.710697358169;4828.493008234155;4833.564979151894;4840.346553215341;4395.230834603932;4400.383946247528;4401.053773438726;4401.977990110029;4410.117976404667;3388.4070287699556;3395.541601883714;3396.252824378633;3415.299863527971;3429.4855771634457;1072.4369705904462;1076.8707755069443;1079.5304042741432;1081.734974931131;1084.4577711144427;1008.2488546033105;1052.957881684724;1055;1188.4592510407745;1347.2320777157122;7122.180949190806;7192.82017949545;7245.239249878792;7245.384142347854;7251.854962900712;389.6317979509337;394.3729470142487;396.6747267240892;397.79314756327125;397.8130278768974;5373;5704.80033198836;5787.479126878601;5790.305163380337;5797.188393624896;8179.345652347798;8779.648814047367;9009.63961441535;9017.729468115967;9021.142991415805;8803.471791692518;8906.153915378029;8961;8975.147361000694;8994.28045756338;7069.540479868792;7179.856402871913;7188.604626745475;7191.316824901626;7204.963975180195;6893.379595836399;7000.074979380711;7000.159980802337;7004.509684322048;7025;7821.139674635671;8047.51714897108;8107.3108785753875;8108.675652973815;8109.148539403278;8029.839403211786;8227.958860205661;8234.505929644241;8245.051819040887;8248.793780155544;6692.130023096966;6738.292479289604;6755.695993680394;6759.188897332351;6763.086983257197;7235.782926512213;7236;7280.235575264521;7281.963590182015;7290.161631412456;6566.507511936719;6765.188177418741;6767.120274364301;6851.725930962705;6861.931380686129;6660.666966651745;6669;6751.662416879235;6762.391384775394;6776.695048722918;6850.177978642595;6894.724211031703;6927.134108236471;6938.930610693828;6945.888657814726;6241.095041219089;6281.183446151971;6282.277538082996;6297.748090076529;6312.905306420315;6281.214848143982;6296.0555916612875;6322.3045464997895;6342.651154186564;6386.680665966776 17:16:17 INFO - 2015-11-05 17:16:17,906 DEBUG : BROWSER_OUTPUT: |4;prototype.html;303.9650440199377;315.64805242154995;316.37358031098427;321.72974701250945;323.54057238721015;5970.373110823366;6051.243594550681;6062.030075187965;6071.78748743794;6073.362296958822;5980.162777211183;5980.700964951746;5986.431289027546;5991.520678345732;6001.849953751158;4619.769011549409;4631.143238500888;4652.97673511632;4657.2315567931255;4658.883527911796;4452.510223875371;4551.340055691922;4638.5593368629925;4643.373144625466;4648.581627653511;4490.7530085845265;4494.168578812913;4500.257457519506;4516.345129956155;4531.524189960056;4499.0776890737325;4504.099180163964;4507.706999045052;4512.45850497939;4515.63874890008;3705.573859006222;3769.5476542814763;3814.5422549293985;3852;3860.034991252187;5804.970975145097;5821;5841.240638716939;5858.619189752652;5871.618344807616;4902.338184345103;4992.350994370745;5063.620228482841;5080.466551012164;5102.413222479426;6194;6211.81364559064;6225.906611400833;6234.563580549363;6236.563440559163;4181.498220213563;4182.811773470201;4187.476565429321;4188.518320393163;4191.601797829201;6512.023196520512;6596.406323430866;6618.172728408949;6618.635975021371;6624.205095388536;4197.433346498245;4248.553901840324;4249.426327445817;4254.659627229814;4254.744715317091;4292.313229883266;4301.591348821857;4309.5044069932355;4329.090890912944;4336.761478118734;5020.046191223729;5040.243963405445;5041.521055499722;5058.924116138261;5061.7975280989085;6127.6936153193055;6247;6252.09344645033;6262.780802671976;6266.467350275278;1529.6175956010998;1566.3186513866503;1568.7019466301367;1570.089348178054;1571.1751330551551;994.9502524873727;1009.0363702663939;1014.0771897573173;1020.8672872526524;1025.6307729217476;6098.481629061579;6125.050617154348;6129.295131059896;6135.018397056539;6150.200473938359;6579.17760279965;6590.406863382223;6597.901031484532;6613.041109039163;6615.768448104293;5959.4934430573885;6119.388061193845;6119.785807496805;6140.3552626974415;6145.938540614537;3633.3278343506536;3657.3416784978426;3669.119411341259;3676.3750162472443;3686.64976827201;6702.396784289437;6710.966445167841;6721.462283017347;6723.529352945345;6739.528233023641;6726.899096513556;6731.528792984542;6748.156480439945;6750.493712971547;6759.628220447824;6698.933010669928;6749.898751518731;6752.189737231563;6777.152855893013;6785.796426107126;6624.370684784938;6629.6353700545005;6643.833904152435;6668.599884006781;6674.933250667431;6315.968420158054;6478.578892371981;6484.610923344614;6501.4798816095545;6518.641474718936;6741.056252124805;6751.831204219934;6761;6788.321167883172;6850.314968503109;4330.588594083557;4385.693001489993;4395.0111224974125;4395.670324725595;4409.40473036136;6672.933270667425;6677.966610166918;6687.899681504879;6688.230853451915;6696.229933557508;6295.96852015737;6473.643949582818;6492.188476440445;6508.153939987771;6537.378948999837;6452.064450654535;6461.741530338733;6466.094746735367;6473.255575608865;6481.319461456667;6167.880861938371;6288.591241569284;6295.213098362705;6297.748090076529;6307.590006649553;6473.805785826433;6476.773312934025;6499.38255865692;6509;6517.73929042833;6335.334789847;6343.619382837044;6358.459530939922;6359.554831161774;6366.427021568081 17:16:17 INFO - 2015-11-05 17:16:17,908 DEBUG : BROWSER_OUTPUT: |5;yui.html;693.8508220732541;726.7674344209852;759.3166150464584;774.303127185533;774.9108852481965;14170.858291417082;14200.958849380733;14356.928215358908;14381.2809359532;14403.495877644285;13354.599362019131;13495.392707328168;13536.661583460418;13551;13565.728685426286;721.3940290156268;733.2630706140321;913.7487191022456;915.8214148241095;916.9770755731126;912.1835956818643;919.8160367926408;931.3340961212732;932.282142750082;932.9813403731921;963.8939716631165;969.1084202533651;969.8060387922409;970.112347202309;970.553545369131;758.3553979117734;771.1093686791764;936.3398803843274;958.3435346787403;968.428627110005;708.2952462299993;708.3200127877244;708.3447810775064;708.3837061756253;709.6238993333542;13932.651683707887;14107.365168567336;14110.365033573515;14167.433302667881;14186.787198192036;11884.643460696192;12012.69968250792;12068.577599783965;12108.455119519644;12266.202696824677;9386.20217281532;9410.62357505699;9497.14525692691;10106.848397274047;10157.796844063152;3331.983340083284;3388.0682812226587;3419.1793969447403;3433.9484907726405;3441.380551500729;47644.28533571964;48343.51656483425;48800;48903.26645100326;49040.26439603409;9068.591913363782;9084.273258139334;9283.442993420416;9296.116868897443;9638.759031024281;11718.121140914465;11809.114316426303;11843.46704398287;11850.11124165691;11851.288922664668;6304.810855674245;6352.396522330371;6356.618602883842;6401.135846660642;6444.806655800334;3900.6294402031763;3944.6647035001774;4049.7772622505454;4102.851201663539;4179.2059508693255;2570.151849889532;2591.4687489064695;2593.6109583562616;2597.6233446150204;2597.8960841566127;386.4165110682833;393.44917116037203;396.2392206962639;397.91643754811815;401.10553465771494;505.8586179823265;512.6539585779658;516.506736067055;563.5519761789387;618.6906546726636;7792.961035194901;8137.918620813834;8139.79650508742;8756.474611523328;8833.779155521164;438.45631417042637;445.1120015568896;593.4036293525066;599.7600959616101;652.4356431686651;3671.5227020487164;3888.5528164261473;3942.073612701013;3984.6812255019527;3996.500437445319;51454.48545514497;51546.22680659793;55397.44602554003;55790;55966.72016639972;49589.50410495921;49945;49980;50029;50042.74978625084;45478.545214548096;47651.76174119177;48406.27390589144;49224.75387623039;49354.25968610402;8391.916080839113;8416.915830841614;8441.071482137082;8621.784455388666;8694.130586941255;34936.12659683528;35549;35868.820655896554;35929;37039.81480092582;43205.56794432015;45826;48275.517244827104;48307.5169248303;48551.5144848547;10427.165826733995;10517.15862730995;10736.946315268686;10821.458927053773;11194.552217911192;11112.706815694482;11150.163737719866;11222.66332010041;11338.773224535627;11370.54517819278;10586.89413105859;10723.89276107229;10999.980135475977;11353.432328383713;11497.942510287396;10449.477526123512;10730.678079657622;10835.729106772395;11003.284786488852;11329;10491.895081049091;10588.4705764713;10800.675979720621;10822.134229261797;11405.144614153805;9144.139650872818;9199.632014719336;9212.815743684954;9586.760330991781;9633.421994680342;8616.78458038554;8964.282857371265;9079;9532.428054316762;9557.952210238904 17:16:17 INFO - 2015-11-05 17:16:17,908 DEBUG : BROWSER_OUTPUT: __end_tp_report 17:16:17 INFO - 2015-11-05 17:16:17,908 DEBUG : BROWSER_OUTPUT: __start_cc_report 17:16:17 INFO - 2015-11-05 17:16:17,908 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1621 17:16:17 INFO - 2015-11-05 17:16:17,909 DEBUG : BROWSER_OUTPUT: __end_cc_report 17:16:17 INFO - 2015-11-05 17:16:17,909 DEBUG : BROWSER_OUTPUT: __startTimestamp1446772577895__endTimestamp 17:16:17 INFO - 2015-11-05 17:16:17,909 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,909 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 17:16:17 INFO - 2015-11-05 17:16:17,909 DEBUG : BROWSER_OUTPUT: Number of tests: 6 17:16:17 INFO - 2015-11-05 17:16:17,910 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,910 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5350.02 Median:5479.15 stddev:570.05 (10.4%) stddev-sans-first:545.38 17:16:17 INFO - 2015-11-05 17:16:17,911 DEBUG : BROWSER_OUTPUT: Values: 3163.5 3198.1 3216.7 3227.8 3260.9 5123.6 5262.0 5324.9 5341.8 5345.1 5365.3 5372.4 5428.2 5431.3 5555.9 4931.4 4970.6 4999.0 5015.1 5076.0 5017.8 5172.7 5172.9 5178.9 5181.2 4738.5 4815.7 4863.3 4982.8 5106.2 4972.4 4978.4 4979.7 4986.2 5020.1 4935.2 4936.2 4943.2 4966.5 4998.0 5118.8 5199.8 5227.7 5297.6 5441.3 5665.4 5686.0 5689.1 5692.6 5703.0 5745.6 5747.7 5750.3 5758.2 5764.9 5289.7 5289.9 5366.7 5401.2 5406.1 5863.5 5880.6 5924.3 5933.5 5935.4 5646.9 5652.4 5660.3 5685.5 5701.3 5409.6 5477.1 5479.2 5492.6 5498.7 5556.0 5574.2 5633.4 5717.0 5760.0 5566.2 5594.6 5602.4 5605.5 5609.9 4400.4 4404.4 4414.0 4415.2 4435.2 3958.4 4018.0 4054.0 4058.9 4076.7 5312.8 5325.4 5330.0 5336.1 5358.7 5814.6 5831.1 5840.5 5845.0 5856.8 5423.9 5449.6 5463.5 5470.2 5472.0 5080.8 5091.3 5094.3 5099.5 5099.8 5896.7 5908.0 5916.0 5917.7 5927.6 5785.2 5786.1 5858.4 5873.3 5896.1 5938.9 5945.1 5957.4 5979.3 5982.2 5464.9 5549.4 5554.7 5766.3 5766.9 5745.3 5788.4 5790.8 5792.4 5827.5 5619.2 5677.7 5726.6 5729.2 5731.8 5435.0 5534.6 5554.9 5702.0 5708.1 5467.8 5474.0 5475.8 5479.0 5482.8 5648.3 5675.7 5685.1 5693.5 5702.2 5547.0 5559.2 5577.7 5580.4 5583.1 17:16:17 INFO - 2015-11-05 17:16:17,911 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,911 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:50379.47 Median:33097.42 stddev:84465.30 (255.2%) stddev-sans-first:84619.47 17:16:17 INFO - 2015-11-05 17:16:17,913 DEBUG : BROWSER_OUTPUT: Values: 574.5 578.7 584.1 586.3 589.0 32533.8 32970.2 41321.4 42131.8 42147.6 43875.6 44359.1 44360.1 44394.3 44433.1 8330.5 9385.1 9529.2 9582.8 9582.9 8488.2 11268.0 11488.7 11498.6 11507.7 11166.4 11324.5 11325.8 11332.6 11361.1 8460.3 8617.6 11197.0 11267.3 11364.5 10906.8 10999.5 11016.7 11044.2 11068.1 41196.0 41689.8 41753.0 41782.4 41820.4 2947.9 2996.8 3002.9 3009.8 3113.1 28025.4 28074.0 28255.7 28360.0 28552.9 2345.7 2363.3 2408.1 2408.9 2505.5 297223.0 302015.0 302376.0 303093.0 303762.0 57675.0 58924.4 61723.7 62325.0 62412.0 60670.0 61260.4 61567.7 61629.7 61679.1 16998.4 17225.1 17235.9 17237.2 17242.6 12073.4 12099.9 12106.6 12109.8 12115.9 20665.2 21474.5 21531.1 21615.9 21665.8 9116.0 9428.6 9434.9 9444.6 9450.8 924.3 1050.4 1052.7 1101.9 1115.2 29305.3 29791.0 29941.3 32262.8 33520.7 1020.6 1084.0 1088.6 1098.8 1171.0 15241.6 15423.4 15561.2 15623.4 15644.7 363498.0 369326.0 369436.0 370319.0 371742.0 57299.7 57883.4 57892.7 57911.4 57992.4 1407.1 1416.3 1417.5 1417.9 1436.6 29486.7 29956.6 32955.8 33224.7 33327.3 54445.2 54986.0 55056.2 55058.0 55082.0 289900.2 293417.0 293674.0 294774.0 295137.0 39217.4 40069.4 43349.0 44300.3 44906.8 42430.2 43427.6 44426.6 45034.3 45875.0 36760.8 37994.8 38847.6 38887.2 38963.0 35636.8 37214.6 40742.8 41386.4 41867.0 37638.2 38078.8 38801.4 38838.0 38887.6 31823.0 33899.0 34063.0 34070.8 34084.3 25426.9 25834.4 25858.6 25868.6 26121.3 17:16:17 INFO - 2015-11-05 17:16:17,913 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,913 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:27679.71 Median:481.45 stddev:89241.14 (18535.9%) stddev-sans-first:89467.87 17:16:17 INFO - 2015-11-05 17:16:17,914 DEBUG : BROWSER_OUTPUT: Values: 339.0 341.5 344.5 344.8 350.8 14567.9 14970.6 16983.8 17130.7 17592.0 14442.6 15614.8 17622.7 18009.5 18224.9 5300.7 5438.2 5452.6 5456.4 5456.6 3928.3 4052.5 5274.4 5422.8 5453.6 5781.4 5855.2 5942.3 5963.0 5973.5 5788.3 5924.5 5932.3 5947.5 5949.5 5118.7 5119.1 5119.9 5120.6 5132.6 21579.7 21999.1 22315.4 22359.4 22390.1 1939.6 2037.7 2047.6 2099.5 2175.2 13488.9 13670.7 13732.9 13744.6 13763.5 1677.3 1692.6 1699.2 1706.1 1749.9 58652.1 59027.0 59544.7 59723.7 60549.7 9455.0 9644.3 9812.4 9832.4 9888.7 11927.7 11949.8 11958.2 11970.7 11973.3 5131.9 5142.8 5145.5 5377.2 8218.7 5855.0 5855.8 5856.2 5868.5 5903.2 2743.0 2768.9 2772.3 2784.7 2788.7 963.8 991.0 1000.0 1015.8 1047.3 408.5 412.2 417.1 433.5 438.0 10951.5 11249.8 11391.6 11652.5 11740.9 422.7 430.9 445.0 445.0 445.1 5520.6 6035.4 6114.5 6130.4 6132.8 524562.0 527890.0 543226.0 564094.0 565582.0 70438.0 70846.0 71980.6 73259.0 77349.0 471.9 479.5 480.9 481.1 481.8 10693.9 10782.4 10805.8 10857.3 10880.2 36504.6 36898.3 37074.8 37076.0 37243.3 48774.3 49551.8 49739.3 50136.5 50237.2 7267.9 7336.3 7382.0 7433.6 7439.4 11420.7 11509.4 11514.7 11514.7 11523.0 9528.0 9600.2 10006.5 10011.8 10044.3 9585.5 9646.4 9656.3 9661.4 9850.6 9876.5 9985.9 9988.5 10009.4 10036.2 7074.1 7420.1 7483.7 7488.1 7507.9 9724.0 9914.4 9996.2 10006.0 10015.0 17:16:17 INFO - 2015-11-05 17:16:17,915 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,915 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5263.45 Median:6332.48 stddev:2741.07 (43.3%) stddev-sans-first:2732.36 17:16:17 INFO - 2015-11-05 17:16:17,915 DEBUG : BROWSER_OUTPUT: Values: 1273.8 1454.7 1525.2 1692.7 1837.2 7040.4 7515.7 7622.8 7647.2 7654.1 7315.5 7634.0 7648.1 7650.2 7657.6 2153.7 2169.2 2174.8 2174.9 2176.8 2141.2 2143.2 2262.7 2268.1 2270.5 2170.0 2194.4 2197.0 2201.3 2207.0 2149.1 2153.3 2155.2 2155.7 2161.6 2144.2 2182.8 2183.0 2185.7 2186.7 6768.9 6923.9 7520.7 7561.8 7563.4 4538.7 4650.9 4653.2 4668.5 4670.8 2780.7 2807.6 2850.3 2855.0 2902.1 840.3 852.4 854.4 861.5 865.8 9952.3 9993.0 10001.2 10009.1 10017.4 4159.8 4202.6 4208.1 4208.9 4343.8 8839.6 8840.0 8843.4 8852.1 8863.3 4821.6 4821.7 4828.5 4833.6 4840.3 4395.2 4400.4 4401.1 4402.0 4410.1 3388.4 3395.5 3396.3 3415.3 3429.5 1072.4 1076.9 1079.5 1081.7 1084.5 1008.2 1053.0 1055.0 1188.5 1347.2 7122.2 7192.8 7245.2 7245.4 7251.9 389.6 394.4 396.7 397.8 397.8 5373.0 5704.8 5787.5 5790.3 5797.2 8179.3 8779.6 9009.6 9017.7 9021.1 8803.5 8906.2 8961.0 8975.1 8994.3 7069.5 7179.9 7188.6 7191.3 7205.0 6893.4 7000.1 7000.2 7004.5 7025.0 7821.1 8047.5 8107.3 8108.7 8109.1 8029.8 8228.0 8234.5 8245.1 8248.8 6692.1 6738.3 6755.7 6759.2 6763.1 7235.8 7236.0 7280.2 7282.0 7290.2 6566.5 6765.2 6767.1 6851.7 6861.9 6660.7 6669.0 6751.7 6762.4 6776.7 6850.2 6894.7 6927.1 6938.9 6945.9 6241.1 6281.2 6282.3 6297.7 6312.9 6281.2 6296.1 6322.3 6342.7 6386.7 17:16:17 INFO - 2015-11-05 17:16:17,915 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,915 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5288.21 Median:6108.93 stddev:1638.03 (26.8%) stddev-sans-first:1599.34 17:16:17 INFO - 2015-11-05 17:16:17,917 DEBUG : BROWSER_OUTPUT: Values: 304.0 315.6 316.4 321.7 323.5 5970.4 6051.2 6062.0 6071.8 6073.4 5980.2 5980.7 5986.4 5991.5 6001.8 4619.8 4631.1 4653.0 4657.2 4658.9 4452.5 4551.3 4638.6 4643.4 4648.6 4490.8 4494.2 4500.3 4516.3 4531.5 4499.1 4504.1 4507.7 4512.5 4515.6 3705.6 3769.5 3814.5 3852.0 3860.0 5805.0 5821.0 5841.2 5858.6 5871.6 4902.3 4992.4 5063.6 5080.5 5102.4 6194.0 6211.8 6225.9 6234.6 6236.6 4181.5 4182.8 4187.5 4188.5 4191.6 6512.0 6596.4 6618.2 6618.6 6624.2 4197.4 4248.6 4249.4 4254.7 4254.7 4292.3 4301.6 4309.5 4329.1 4336.8 5020.0 5040.2 5041.5 5058.9 5061.8 6127.7 6247.0 6252.1 6262.8 6266.5 1529.6 1566.3 1568.7 1570.1 1571.2 995.0 1009.0 1014.1 1020.9 1025.6 6098.5 6125.1 6129.3 6135.0 6150.2 6579.2 6590.4 6597.9 6613.0 6615.8 5959.5 6119.4 6119.8 6140.4 6145.9 3633.3 3657.3 3669.1 3676.4 3686.6 6702.4 6711.0 6721.5 6723.5 6739.5 6726.9 6731.5 6748.2 6750.5 6759.6 6698.9 6749.9 6752.2 6777.2 6785.8 6624.4 6629.6 6643.8 6668.6 6674.9 6316.0 6478.6 6484.6 6501.5 6518.6 6741.1 6751.8 6761.0 6788.3 6850.3 4330.6 4385.7 4395.0 4395.7 4409.4 6672.9 6678.0 6687.9 6688.2 6696.2 6296.0 6473.6 6492.2 6508.2 6537.4 6452.1 6461.7 6466.1 6473.3 6481.3 6167.9 6288.6 6295.2 6297.7 6307.6 6473.8 6476.8 6499.4 6509.0 6517.7 6335.3 6343.6 6358.5 6359.6 6366.4 17:16:17 INFO - 2015-11-05 17:16:17,917 DEBUG : BROWSER_OUTPUT: 17:16:17 INFO - 2015-11-05 17:16:17,917 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13469.17 Median:48325.52 stddev:15937.50 (33.0%) stddev-sans-first:15953.34 17:16:17 INFO - 2015-11-05 17:16:17,919 DEBUG : BROWSER_OUTPUT: Values: 693.9 726.8 759.3 774.3 774.9 14170.9 14201.0 14356.9 14381.3 14403.5 13354.6 13495.4 13536.7 13551.0 13565.7 721.4 733.3 913.7 915.8 917.0 912.2 919.8 931.3 932.3 933.0 963.9 969.1 969.8 970.1 970.6 758.4 771.1 936.3 958.3 968.4 708.3 708.3 708.3 708.4 709.6 13932.7 14107.4 14110.4 14167.4 14186.8 11884.6 12012.7 12068.6 12108.5 12266.2 9386.2 9410.6 9497.1 10106.8 10157.8 3332.0 3388.1 3419.2 3433.9 3441.4 47644.3 48343.5 48800.0 48903.3 49040.3 9068.6 9084.3 9283.4 9296.1 9638.8 11718.1 11809.1 11843.5 11850.1 11851.3 6304.8 6352.4 6356.6 6401.1 6444.8 3900.6 3944.7 4049.8 4102.9 4179.2 2570.2 2591.5 2593.6 2597.6 2597.9 386.4 393.4 396.2 397.9 401.1 505.9 512.7 516.5 563.6 618.7 7793.0 8137.9 8139.8 8756.5 8833.8 438.5 445.1 593.4 599.8 652.4 3671.5 3888.6 3942.1 3984.7 3996.5 51454.5 51546.2 55397.4 55790.0 55966.7 49589.5 49945.0 49980.0 50029.0 50042.7 45478.5 47651.8 48406.3 49224.8 49354.3 8391.9 8416.9 8441.1 8621.8 8694.1 34936.1 35549.0 35868.8 35929.0 37039.8 43205.6 45826.0 48275.5 48307.5 48551.5 10427.2 10517.2 10736.9 10821.5 11194.6 11112.7 11150.2 11222.7 11338.8 11370.5 10586.9 10723.9 11000.0 11353.4 11497.9 10449.5 10730.7 10835.7 11003.3 11329.0 10491.9 10588.5 10800.7 10822.1 11405.1 9144.1 9199.6 9212.8 9586.8 9633.4 8616.8 8964.3 9079.0 9532.4 9558.0 17:16:17 INFO - 2015-11-05 17:16:17,919 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 17:16:17 INFO - 2015-11-05 17:16:17,919 DEBUG : BROWSER_OUTPUT: 17:16:18 INFO - 2015-11-05 17:16:18,590 INFO : Browser exited with error code: 0 17:16:18 INFO - 2015-11-05 17:16:18,617 INFO : Completed test dromaeo_css (00:18:33) 17:16:18 INFO - 2015-11-05 17:16:18,617 INFO : Starting test kraken 17:16:18 INFO - 2015-11-05 17:16:18,617 DEBUG : operating with platform_type : mac_ 17:16:18 INFO - 2015-11-05 17:16:18,618 INFO : Initialising browser for kraken test... 17:16:18 INFO - 2015-11-05 17:16:18,631 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/tmp_X1BUf/profile http://localhost:58116/getInfo.html 17:16:20 INFO - 2015-11-05 17:16:20,725 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 17:16:20 INFO - 2015-11-05 17:16:20,725 DEBUG : BROWSER_OUTPUT: colorDepth:24 17:16:20 INFO - 2015-11-05 17:16:20,725 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 17:16:20 INFO - 2015-11-05 17:16:20,725 DEBUG : BROWSER_OUTPUT: __metrics 17:16:20 INFO - 2015-11-05 17:16:20,741 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 17:16:21 INFO - 2015-11-05 17:16:21,352 INFO : Browser initialized. 17:16:21 INFO - 2015-11-05 17:16:21,352 INFO : Running cycle 1/1 for kraken test... 17:16:21 INFO - 2015-11-05 17:16:21,352 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/tmp_X1BUf/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 17:16:33 INFO - 2015-11-05 17:16:33,158 DEBUG : BROWSER_OUTPUT: RSS: Main: 223764480 17:16:33 INFO - 2015-11-05 17:16:33,159 DEBUG : BROWSER_OUTPUT: 17:16:35 INFO - 2015-11-05 17:16:35,702 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58116/tests/kraken/driver.html?testName=audio-beat-detection) 17:16:36 INFO - 2015-11-05 17:16:36,288 DEBUG : BROWSER_OUTPUT: RSS: Main: 281149440 17:16:36 INFO - 2015-11-05 17:16:36,288 DEBUG : BROWSER_OUTPUT: 17:16:38 INFO - 2015-11-05 17:16:38,935 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58116/tests/kraken/driver.html?testName=audio-dft) 17:16:39 INFO - 2015-11-05 17:16:39,516 DEBUG : BROWSER_OUTPUT: RSS: Main: 292868096 17:16:39 INFO - 2015-11-05 17:16:39,516 DEBUG : BROWSER_OUTPUT: 17:16:42 INFO - 2015-11-05 17:16:42,477 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58116/tests/kraken/driver.html?testName=audio-fft) 17:16:43 INFO - 2015-11-05 17:16:43,054 DEBUG : BROWSER_OUTPUT: RSS: Main: 276631552 17:16:43 INFO - 2015-11-05 17:16:43,054 DEBUG : BROWSER_OUTPUT: 17:16:45 INFO - 2015-11-05 17:16:45,156 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58116/tests/kraken/driver.html?testName=audio-oscillator) 17:16:45 INFO - 2015-11-05 17:16:45,733 DEBUG : BROWSER_OUTPUT: RSS: Main: 276856832 17:16:45 INFO - 2015-11-05 17:16:45,733 DEBUG : BROWSER_OUTPUT: 17:16:47 INFO - 2015-11-05 17:16:47,903 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58116/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:16:48 INFO - 2015-11-05 17:16:48,487 DEBUG : BROWSER_OUTPUT: RSS: Main: 276897792 17:16:48 INFO - 2015-11-05 17:16:48,487 DEBUG : BROWSER_OUTPUT: 17:16:51 INFO - 2015-11-05 17:16:51,506 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58116/tests/kraken/driver.html?testName=imaging-darkroom) 17:16:52 INFO - 2015-11-05 17:16:52,095 DEBUG : BROWSER_OUTPUT: RSS: Main: 276971520 17:16:52 INFO - 2015-11-05 17:16:52,095 DEBUG : BROWSER_OUTPUT: 17:16:55 INFO - 2015-11-05 17:16:55,205 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58116/tests/kraken/driver.html?testName=imaging-desaturate) 17:16:55 INFO - 2015-11-05 17:16:55,790 DEBUG : BROWSER_OUTPUT: RSS: Main: 278339584 17:16:55 INFO - 2015-11-05 17:16:55,791 DEBUG : BROWSER_OUTPUT: 17:16:58 INFO - 2015-11-05 17:16:58,635 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58116/tests/kraken/driver.html?testName=json-parse-financial) 17:16:59 INFO - 2015-11-05 17:16:59,222 DEBUG : BROWSER_OUTPUT: RSS: Main: 277700608 17:16:59 INFO - 2015-11-05 17:16:59,222 DEBUG : BROWSER_OUTPUT: 17:17:00 INFO - 2015-11-05 17:17:00,779 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58116/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:17:01 INFO - 2015-11-05 17:17:01,345 DEBUG : BROWSER_OUTPUT: RSS: Main: 311869440 17:17:01 INFO - 2015-11-05 17:17:01,345 DEBUG : BROWSER_OUTPUT: 17:17:03 INFO - 2015-11-05 17:17:03,154 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58116/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:17:03 INFO - 2015-11-05 17:17:03,770 DEBUG : BROWSER_OUTPUT: RSS: Main: 312913920 17:17:03 INFO - 2015-11-05 17:17:03,770 DEBUG : BROWSER_OUTPUT: 17:17:05 INFO - 2015-11-05 17:17:05,839 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58116/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:17:06 INFO - 2015-11-05 17:17:06,422 DEBUG : BROWSER_OUTPUT: RSS: Main: 319094784 17:17:06 INFO - 2015-11-05 17:17:06,422 DEBUG : BROWSER_OUTPUT: 17:17:08 INFO - 2015-11-05 17:17:08,957 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58116/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:17:09 INFO - 2015-11-05 17:17:09,544 DEBUG : BROWSER_OUTPUT: RSS: Main: 322650112 17:17:09 INFO - 2015-11-05 17:17:09,544 DEBUG : BROWSER_OUTPUT: 17:17:12 INFO - 2015-11-05 17:17:12,161 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58116/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:17:12 INFO - 2015-11-05 17:17:12,735 DEBUG : BROWSER_OUTPUT: RSS: Main: 320331776 17:17:12 INFO - 2015-11-05 17:17:12,735 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,459 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58116/tests/kraken/driver.html?testName=ai-astar) 17:17:14 INFO - 2015-11-05 17:17:14,709 DEBUG : BROWSER_OUTPUT: RSS: Main: 379629568 17:17:14 INFO - 2015-11-05 17:17:14,709 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,710 DEBUG : BROWSER_OUTPUT: __start_tp_report 17:17:14 INFO - 2015-11-05 17:17:14,710 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 17:17:14 INFO - 2015-11-05 17:17:14,711 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 17:17:14 INFO - 2015-11-05 17:17:14,711 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 17:17:14 INFO - 2015-11-05 17:17:14,711 DEBUG : BROWSER_OUTPUT: |0;ai-astar;106;107;106;110;109;107;100;108;109;108 17:17:14 INFO - 2015-11-05 17:17:14,711 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;162;129;153;163;128;150;148;125;164;128 17:17:14 INFO - 2015-11-05 17:17:14,711 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;161;160;161;161;161;162;162;162;159 17:17:14 INFO - 2015-11-05 17:17:14,712 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;82;90;85;68;69;69;79;83;66 17:17:14 INFO - 2015-11-05 17:17:14,712 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;99;98;136;89;88;89;122;86;87;127 17:17:14 INFO - 2015-11-05 17:17:14,712 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;120;120;120;119;120;115;115;115;114;120 17:17:14 INFO - 2015-11-05 17:17:14,712 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;126;125;125;124;125;125;125;124;125;124 17:17:14 INFO - 2015-11-05 17:17:14,712 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;100;100;100;101;101;101;100;100;101;101 17:17:14 INFO - 2015-11-05 17:17:14,712 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;58;59;57;57;59;59;58;66;56;57 17:17:14 INFO - 2015-11-05 17:17:14,712 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;66;66;68;67;68;68;68;68;68;67 17:17:14 INFO - 2015-11-05 17:17:14,713 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;85;85;84;86;85;86;85;85;85;85 17:17:14 INFO - 2015-11-05 17:17:14,713 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;126;130;126;123;129;130;134;129;123;122 17:17:14 INFO - 2015-11-05 17:17:14,713 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;149;150;150;148;153;152;150;152;148;143 17:17:14 INFO - 2015-11-05 17:17:14,713 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;70;68;70;69;71;70;69;68;70;72 17:17:14 INFO - 2015-11-05 17:17:14,713 DEBUG : BROWSER_OUTPUT: __end_tp_report 17:17:14 INFO - 2015-11-05 17:17:14,714 DEBUG : BROWSER_OUTPUT: __start_cc_report 17:17:14 INFO - 2015-11-05 17:17:14,714 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,902 17:17:14 INFO - 2015-11-05 17:17:14,715 DEBUG : BROWSER_OUTPUT: __end_cc_report 17:17:14 INFO - 2015-11-05 17:17:14,715 DEBUG : BROWSER_OUTPUT: __startTimestamp1446772634709__endTimestamp 17:17:14 INFO - 2015-11-05 17:17:14,716 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,716 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 17:17:14 INFO - 2015-11-05 17:17:14,716 DEBUG : BROWSER_OUTPUT: Number of tests: 14 17:17:14 INFO - 2015-11-05 17:17:14,716 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,716 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:107.00 Median:108.00 stddev:2.79 (2.6%) stddev-sans-first:2.93 17:17:14 INFO - 2015-11-05 17:17:14,716 DEBUG : BROWSER_OUTPUT: Values: 106.0 107.0 106.0 110.0 109.0 107.0 100.0 108.0 109.0 108.0 17:17:14 INFO - 2015-11-05 17:17:14,716 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,717 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:145.00 Median:151.50 stddev:16.01 (10.6%) stddev-sans-first:15.75 17:17:14 INFO - 2015-11-05 17:17:14,717 DEBUG : BROWSER_OUTPUT: Values: 162.0 129.0 153.0 163.0 128.0 150.0 148.0 125.0 164.0 128.0 17:17:14 INFO - 2015-11-05 17:17:14,717 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,717 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.00 Median:161.00 stddev:0.94 (0.6%) stddev-sans-first:1.00 17:17:14 INFO - 2015-11-05 17:17:14,717 DEBUG : BROWSER_OUTPUT: Values: 161.0 161.0 160.0 161.0 161.0 161.0 162.0 162.0 162.0 159.0 17:17:14 INFO - 2015-11-05 17:17:14,717 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,717 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:76.40 Median:80.50 stddev:8.44 (10.5%) stddev-sans-first:8.86 17:17:14 INFO - 2015-11-05 17:17:14,717 DEBUG : BROWSER_OUTPUT: Values: 73.0 82.0 90.0 85.0 68.0 69.0 69.0 79.0 83.0 66.0 17:17:14 INFO - 2015-11-05 17:17:14,718 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,718 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:102.10 Median:88.50 stddev:18.92 (21.4%) stddev-sans-first:20.03 17:17:14 INFO - 2015-11-05 17:17:14,718 DEBUG : BROWSER_OUTPUT: Values: 99.0 98.0 136.0 89.0 88.0 89.0 122.0 86.0 87.0 127.0 17:17:14 INFO - 2015-11-05 17:17:14,718 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,718 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:117.80 Median:120.00 stddev:2.66 (2.2%) stddev-sans-first:2.70 17:17:14 INFO - 2015-11-05 17:17:14,718 DEBUG : BROWSER_OUTPUT: Values: 120.0 120.0 120.0 119.0 120.0 115.0 115.0 115.0 114.0 120.0 17:17:14 INFO - 2015-11-05 17:17:14,719 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,719 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:124.80 Median:125.00 stddev:0.63 (0.5%) stddev-sans-first:0.50 17:17:14 INFO - 2015-11-05 17:17:14,719 DEBUG : BROWSER_OUTPUT: Values: 126.0 125.0 125.0 124.0 125.0 125.0 125.0 124.0 125.0 124.0 17:17:14 INFO - 2015-11-05 17:17:14,719 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,719 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:100.50 Median:101.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 17:17:14 INFO - 2015-11-05 17:17:14,719 DEBUG : BROWSER_OUTPUT: Values: 100.0 100.0 100.0 101.0 101.0 101.0 100.0 100.0 101.0 101.0 17:17:14 INFO - 2015-11-05 17:17:14,719 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,719 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:58.60 Median:58.50 stddev:2.80 (4.8%) stddev-sans-first:2.96 17:17:14 INFO - 2015-11-05 17:17:14,721 DEBUG : BROWSER_OUTPUT: Values: 58.0 59.0 57.0 57.0 59.0 59.0 58.0 66.0 56.0 57.0 17:17:14 INFO - 2015-11-05 17:17:14,721 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.40 Median:68.00 stddev:0.84 (1.2%) stddev-sans-first:0.73 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: Values: 66.0 66.0 68.0 67.0 68.0 68.0 68.0 68.0 68.0 67.0 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.10 Median:85.00 stddev:0.57 (0.7%) stddev-sans-first:0.60 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: Values: 85.0 85.0 84.0 86.0 85.0 86.0 85.0 85.0 85.0 85.0 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:127.20 Median:129.00 stddev:3.85 (3.0%) stddev-sans-first:4.06 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: Values: 126.0 130.0 126.0 123.0 129.0 130.0 134.0 129.0 123.0 122.0 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,722 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:149.50 Median:150.00 stddev:2.84 (1.9%) stddev-sans-first:3.00 17:17:14 INFO - 2015-11-05 17:17:14,723 DEBUG : BROWSER_OUTPUT: Values: 149.0 150.0 150.0 148.0 153.0 152.0 150.0 152.0 148.0 143.0 17:17:14 INFO - 2015-11-05 17:17:14,723 DEBUG : BROWSER_OUTPUT: 17:17:14 INFO - 2015-11-05 17:17:14,723 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.70 Median:70.00 stddev:1.25 (1.8%) stddev-sans-first:1.32 17:17:14 INFO - 2015-11-05 17:17:14,723 DEBUG : BROWSER_OUTPUT: Values: 70.0 68.0 70.0 69.0 71.0 70.0 69.0 68.0 70.0 72.0 17:17:14 INFO - 2015-11-05 17:17:14,723 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 17:17:14 INFO - 2015-11-05 17:17:14,723 DEBUG : BROWSER_OUTPUT: 17:17:15 INFO - 2015-11-05 17:17:15,339 INFO : Browser exited with error code: 0 17:17:15 INFO - 2015-11-05 17:17:15,388 INFO : Completed test kraken (00:00:56) 17:17:15 INFO - 2015-11-05 17:17:15,388 INFO : Starting test v8_7 17:17:15 INFO - 2015-11-05 17:17:15,388 DEBUG : operating with platform_type : mac_ 17:17:15 INFO - 2015-11-05 17:17:15,388 INFO : Initialising browser for v8_7 test... 17:17:15 INFO - 2015-11-05 17:17:15,402 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/tmpm8Wyvq/profile http://localhost:58116/getInfo.html 17:17:17 INFO - 2015-11-05 17:17:17,441 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 17:17:17 INFO - 2015-11-05 17:17:17,442 DEBUG : BROWSER_OUTPUT: colorDepth:24 17:17:17 INFO - 2015-11-05 17:17:17,442 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 17:17:17 INFO - 2015-11-05 17:17:17,442 DEBUG : BROWSER_OUTPUT: __metrics 17:17:17 INFO - 2015-11-05 17:17:17,459 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 17:17:18 INFO - 2015-11-05 17:17:18,103 INFO : Browser initialized. 17:17:18 INFO - 2015-11-05 17:17:18,104 INFO : Running cycle 1/1 for v8_7 test... 17:17:18 INFO - 2015-11-05 17:17:18,104 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/T/tmpm8Wyvq/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 17:17:29 INFO - 2015-11-05 17:17:29,940 DEBUG : BROWSER_OUTPUT: RSS: Main: 222580736 17:17:29 INFO - 2015-11-05 17:17:29,940 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,543 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58116/tests/v8_7/run.html (next: http://localhost:58116/tests/v8_7/run.html) 17:17:51 INFO - 2015-11-05 17:17:51,800 DEBUG : BROWSER_OUTPUT: RSS: Main: 740855808 17:17:51 INFO - 2015-11-05 17:17:51,800 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,800 DEBUG : BROWSER_OUTPUT: __start_tp_report 17:17:51 INFO - 2015-11-05 17:17:51,800 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 17:17:51 INFO - 2015-11-05 17:17:51,800 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 17:17:51 INFO - 2015-11-05 17:17:51,800 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 17:17:51 INFO - 2015-11-05 17:17:51,800 DEBUG : BROWSER_OUTPUT: |0;Richards;166.22340425531914 17:17:51 INFO - 2015-11-05 17:17:51,801 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.46084625694044 17:17:51 INFO - 2015-11-05 17:17:51,801 DEBUG : BROWSER_OUTPUT: |2;Encrypt;324.5699448231094 17:17:51 INFO - 2015-11-05 17:17:51,801 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5758.620689655172 17:17:51 INFO - 2015-11-05 17:17:51,801 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2059.670781893004 17:17:51 INFO - 2015-11-05 17:17:51,801 DEBUG : BROWSER_OUTPUT: |5;Earley;908.2652134423251 17:17:51 INFO - 2015-11-05 17:17:51,801 DEBUG : BROWSER_OUTPUT: |6;Boyer;12370.37037037037 17:17:51 INFO - 2015-11-05 17:17:51,801 DEBUG : BROWSER_OUTPUT: |7;RegExp;28500 17:17:51 INFO - 2015-11-05 17:17:51,802 DEBUG : BROWSER_OUTPUT: |8;Splay;721.1404728789986 17:17:51 INFO - 2015-11-05 17:17:51,802 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;5797.687861271676 17:17:51 INFO - 2015-11-05 17:17:51,802 DEBUG : BROWSER_OUTPUT: __end_tp_report 17:17:51 INFO - 2015-11-05 17:17:51,802 DEBUG : BROWSER_OUTPUT: __startTimestamp1446772671797__endTimestamp 17:17:51 INFO - 2015-11-05 17:17:51,802 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,802 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 17:17:51 INFO - 2015-11-05 17:17:51,802 DEBUG : BROWSER_OUTPUT: Number of tests: 10 17:17:51 INFO - 2015-11-05 17:17:51,802 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,803 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:166.22 Median:166.22 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,803 DEBUG : BROWSER_OUTPUT: Values: 166.2 17:17:51 INFO - 2015-11-05 17:17:51,803 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,803 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.46 Median:191.46 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,803 DEBUG : BROWSER_OUTPUT: Values: 191.5 17:17:51 INFO - 2015-11-05 17:17:51,803 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,803 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:324.57 Median:324.57 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,803 DEBUG : BROWSER_OUTPUT: Values: 324.6 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5758.62 Median:5758.62 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: Values: 5758.6 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2059.67 Median:2059.67 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: Values: 2059.7 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:908.27 Median:908.27 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,804 DEBUG : BROWSER_OUTPUT: Values: 908.3 17:17:51 INFO - 2015-11-05 17:17:51,805 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,805 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12370.37 Median:12370.37 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,805 DEBUG : BROWSER_OUTPUT: Values: 12370.4 17:17:51 INFO - 2015-11-05 17:17:51,805 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,805 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:28500.00 Median:28500.00 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,805 DEBUG : BROWSER_OUTPUT: Values: 28500.0 17:17:51 INFO - 2015-11-05 17:17:51,805 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,805 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:721.14 Median:721.14 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,806 DEBUG : BROWSER_OUTPUT: Values: 721.1 17:17:51 INFO - 2015-11-05 17:17:51,806 DEBUG : BROWSER_OUTPUT: 17:17:51 INFO - 2015-11-05 17:17:51,806 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:5797.69 Median:5797.69 stddev:0.00 (0.0%) 17:17:51 INFO - 2015-11-05 17:17:51,806 DEBUG : BROWSER_OUTPUT: Values: 5797.7 17:17:51 INFO - 2015-11-05 17:17:51,806 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 17:17:51 INFO - 2015-11-05 17:17:51,806 DEBUG : BROWSER_OUTPUT: 17:17:52 INFO - 2015-11-05 17:17:52,440 INFO : Browser exited with error code: 0 17:17:52 INFO - 2015-11-05 17:17:52,459 INFO : Completed test v8_7 (00:00:37) 17:17:52 INFO - 2015-11-05 17:17:52,758 INFO : Completed test suite (00:20:07) 17:17:52 INFO - 2015-11-05 17:17:52,758 DEBUG : Working with test: dromaeo_css 17:17:52 INFO - 2015-11-05 17:17:52,758 DEBUG : Generating results file: dromaeo_css 17:17:52 INFO - 2015-11-05 17:17:52,759 DEBUG : Working with test: kraken 17:17:52 INFO - 2015-11-05 17:17:52,759 DEBUG : Generating results file: kraken 17:17:52 INFO - 2015-11-05 17:17:52,759 INFO : javascript benchmark 17:17:52 INFO - 2015-11-05 17:17:52,759 DEBUG : Working with test: v8_7 17:17:52 INFO - 2015-11-05 17:17:52,759 DEBUG : Generating results file: v8_7 17:17:52 INFO - 2015-11-05 17:17:52,760 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 17:17:52 INFO - 2015-11-05 17:17:52,812 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,1,55]] 17:17:52 INFO - 2015-11-05 17:17:52,813 DEBUG : process_Request line: dromaeo_css 6712.05 graph.html#tests=[[72,1,55]] 17:17:52 INFO - 2015-11-05 17:17:52,813 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 17:17:52 INFO - 2015-11-05 17:17:52,845 DEBUG : process_Request line: kraken 1492.10 graph.html#tests=[[232,1,55]] 17:17:52 INFO - 2015-11-05 17:17:52,845 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 17:17:52 INFO - 2015-11-05 17:17:52,882 DEBUG : process_Request line: v8_7 18114.61 graph.html#tests=[[230,1,55]] 17:17:52 INFO - 2015-11-05 17:17:52,883 INFO : javascript benchmark 17:17:52 INFO - 2015-11-05 17:17:52,885 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [339.0100905356359, 341.5099332457921, 344.4832750873689, 344.77417291673964, 350.83510749947516, 14567.92716036421, 14970.625734356647, 16983.83016169838, 17130.743038854413, 17592.0, 14442.638934026654, 15614.76577851333, 17622.735658965124, 18009.4597162085, 18224.908875455636, 5300.681959082467, 5438.238646589481, 5452.6183167178315, 5456.427075157111, 5456.590755693319, 3928.3321835287925, 4052.49343832021, 5274.367075950891, 5422.75597598107, 5453.563714902818, 5781.421857814227, 5855.23881895353, 5942.316633587128, 5962.97018514909, 5973.4623883850445, 5788.305403351604, 5924.49641780447, 5932.3474417814, 5947.494462970652, 5949.464548190662, 5118.718470484122, 5119.10415677255, 5119.923201151985, 5120.615953803443, 5132.640715149941, 21579.67630485544, 21999.12003519857, 22315.44211394712, 22359.441013974618, 22390.104395824146, 1939.5732938753451, 2037.6739721644465, 2047.580246049571, 2099.454141923111, 2175.216921908112, 13488.86511134886, 13670.657374868513, 13732.931335343359, 13744.587662370144, 13763.518276860263, 1677.2787701288441, 1692.5683950592643, 1699.2013753535819, 1706.121347506023, 1749.8862573932781, 58652.12021819676, 59027.0, 59544.70227648834, 59723.701381492814, 60549.69725151346, 9454.952725236468, 9644.276679249084, 9812.362196457207, 9832.410055396556, 9888.65389711371, 11927.701807454883, 11949.820752688716, 11958.16292859509, 11970.700732481757, 11973.281603103842, 5131.897362052738, 5142.768575414116, 5145.4854514549, 5377.193420986883, 8218.712345067894, 5855.033919403336, 5855.824325270163, 5856.209411729447, 5868.530517558585, 5903.173555702205, 2743.0, 2768.9030883919368, 2772.2514920971225, 2784.721527847199, 2788.6514185726783, 963.8168747938009, 990.9900900990898, 1000.0049950299499, 1015.7663737340453, 1047.3297089862494, 408.5159086482468, 412.190046558514, 417.14485305124373, 433.4863187123269, 438.02757877511874, 10951.4524273786, 11249.775004499865, 11391.601293954838, 11652.475638596283, 11740.882591173979, 422.6513126670509, 430.86427775250695, 444.957729015743, 445.0209539014117, 445.06314208591095, 5520.641158324696, 6035.396460354017, 6114.5414093942245, 6130.356312587203, 6132.816015519542, 524562.0, 527890.0, 543226.0, 564094.0, 565582.0, 70438.0, 70846.0, 71980.64009679918, 73259.0, 77349.0, 471.886747180681, 479.51089888313726, 480.8990112076503, 481.08833760024555, 481.814501416957, 10693.8930610696, 10782.353058816496, 10805.783884322427, 10857.34855908648, 10880.238383313408, 36504.63495365012, 36898.26203475969, 37074.81462592778, 37076.0, 37243.25513489769, 48774.268385973526, 49551.752241238566, 49739.25391119064, 50136.49863501318, 50237.24644130414, 7267.890981635174, 7336.266373362834, 7382.0, 7433.553986760811, 7439.442041846775, 11420.714482138013, 11509.36698481558, 11514.712132196762, 11514.712132196762, 11523.0, 9528.0, 9600.231981441608, 10006.499675016075, 10011.849822252527, 10044.347117437343, 9585.472798996123, 9646.42121472714, 9656.324057316202, 9661.420314781135, 9850.556724947537, 9876.506174691092, 9985.850212246676, 9988.450635215133, 10009.399436033862, 10036.247281454067, 7074.115735533059, 7420.072490938633, 7483.700651974078, 7488.063992001, 7507.924920750941, 9723.951380243336, 9914.40513569188, 9996.150327221976, 10006.0, 10015.048570385801], "dojo.html": [3163.478026125689, 3198.088544764741, 3216.7104960553547, 3227.7579181561387, 3260.8695652173915, 5123.641345105835, 5261.973690131554, 5324.920126198105, 5341.839744807662, 5345.091334473139, 5365.3293338332705, 5372.355317361912, 5428.240046393508, 5431.293931788862, 5555.861103472415, 4931.408231012284, 4970.6023518118645, 4999.0, 5015.122353588125, 5076.0, 5017.824376146836, 5172.741362931857, 5172.9224061638915, 5178.896422071575, 5181.196914478243, 4738.549837765407, 4815.66290359675, 4863.27050942358, 4982.800687972477, 5106.183010718304, 4972.353594032753, 4978.377702787152, 4979.651424400294, 4986.227134794112, 5020.1214787412055, 4935.161022626162, 4936.160852655057, 4943.209086546135, 4966.47851975541, 4998.025385049917, 5118.795248190068, 5199.766010529535, 5227.712475813829, 5297.629165958385, 5441.319835020622, 5665.433456654301, 5686.0, 5689.146628005791, 5692.6299790513895, 5702.971485142548, 5745.597808153431, 5747.741351639186, 5750.252467179282, 5758.193852860602, 5764.855878603026, 5289.735513224324, 5289.947100528984, 5366.7048312343195, 5401.189821526802, 5406.08096623575, 5863.5309175265875, 5880.647161170258, 5924.259467566554, 5933.495652869555, 5935.376785437553, 5646.943530564642, 5652.406497317805, 5660.349059858087, 5685.545156387479, 5701.258836351248, 5409.5672346213, 5477.096279113981, 5479.150731636602, 5492.5605951523785, 5498.725063746797, 5555.972220138954, 5574.16387541872, 5633.380328163898, 5717.0, 5760.049591817303, 5566.2207290979295, 5594.608377413542, 5602.411746766612, 5605.523530499953, 5609.943900561024, 4400.405945197422, 4404.4494438195225, 4413.955860441354, 4415.1611193873705, 4435.223835828717, 3958.3666613342302, 4018.0, 4053.9594604054173, 4058.9188216236103, 4076.673866090706, 5312.814051508179, 5325.3609566851455, 5329.973350133225, 5336.146216605324, 5358.705271210043, 5814.592978491465, 5831.06702927538, 5840.5035571976005, 5845.0, 5856.824295271149, 5423.945760542423, 5449.64577302482, 5463.535599474009, 5470.234167216593, 5472.042392581282, 5080.822171224063, 5091.287219789232, 5094.312267843868, 5099.515546023122, 5099.796008159632, 5896.705164741746, 5908.0, 5916.0, 5917.704114794329, 5927.614705044159, 5785.161151633074, 5786.132080188006, 5858.384869588632, 5873.2658417697785, 5896.056630939029, 5938.881222375442, 5945.137954996588, 5957.4042595740075, 5979.282486101695, 5982.192404025575, 5464.890702185855, 5549.445055494418, 5554.722263886871, 5766.3368712598585, 5766.94233057664, 5745.2818397700285, 5788.421157884178, 5790.826275211751, 5792.420757924174, 5827.475527202572, 5619.185218143428, 5677.687727175045, 5726.627769194989, 5729.197912292199, 5731.799387021434, 5435.0, 5534.584906132137, 5554.944450555443, 5702.0, 5708.058170402003, 5467.808626698046, 5474.0146773579545, 5475.780968761205, 5479.0411677957, 5482.753276102505, 5648.322201335702, 5675.659460432387, 5685.118806584986, 5693.4875861172695, 5702.230198923092, 5547.001539722727, 5559.19391688211, 5577.693226872561, 5580.386157522588, 5583.134614134816], "mootools.html": [1273.7643535945845, 1454.6872422429178, 1525.2221367102775, 1692.7122389193835, 1837.2008176443248, 7040.436765058796, 7515.736949206779, 7622.77131686049, 7647.158812530631, 7654.081510218782, 7315.5244909080875, 7634.0, 7648.120466146394, 7650.158482566913, 7657.578833164173, 2153.7092492513507, 2169.197396963126, 2174.847760656755, 2174.8912554372296, 2176.847620666554, 2141.1970511058353, 2143.228437762404, 2262.671912572676, 2268.138107519149, 2270.4550907782177, 2169.978300217001, 2194.4075099723063, 2197.044285735702, 2201.2955854126685, 2206.9668954965687, 2149.1403438624598, 2153.3432303147533, 2155.2025750472267, 2155.698202251686, 2161.578492194015, 2144.1959265275523, 2182.7817218278205, 2182.978170218309, 2185.715856938604, 2186.726659167604, 6768.932310676929, 6923.930760692429, 7520.661570229353, 7561.7731468056045, 7563.394928405714, 4538.704984176018, 4650.86047418578, 4653.208954477747, 4668.50980647034, 4670.789814458358, 2780.666320041588, 2807.6069350290977, 2850.3016760893506, 2855.0435604072454, 2902.129361191634, 840.2815592668303, 852.403317677622, 854.3976496569966, 861.5218553702692, 865.7532603208056, 9952.253580981456, 9992.95003524985, 10001.249906256988, 10009.099181073738, 10017.449040302781, 4159.75041497505, 4202.579742025773, 4208.116295577902, 4208.915821683549, 4343.82624695015, 8839.646414143492, 8840.0, 8843.380963332633, 8852.070532594114, 8863.290936725047, 4821.614270858323, 4821.710697358169, 4828.493008234155, 4833.564979151894, 4840.346553215341, 4395.230834603932, 4400.383946247528, 4401.053773438726, 4401.977990110029, 4410.117976404667, 3388.4070287699556, 3395.541601883714, 3396.252824378633, 3415.299863527971, 3429.4855771634457, 1072.4369705904462, 1076.8707755069443, 1079.5304042741432, 1081.734974931131, 1084.4577711144427, 1008.2488546033105, 1052.957881684724, 1055.0, 1188.4592510407745, 1347.2320777157122, 7122.180949190806, 7192.82017949545, 7245.239249878792, 7245.384142347854, 7251.854962900712, 389.6317979509337, 394.3729470142487, 396.6747267240892, 397.79314756327125, 397.8130278768974, 5373.0, 5704.80033198836, 5787.479126878601, 5790.305163380337, 5797.188393624896, 8179.345652347798, 8779.648814047367, 9009.63961441535, 9017.729468115967, 9021.142991415805, 8803.471791692518, 8906.153915378029, 8961.0, 8975.147361000694, 8994.28045756338, 7069.540479868792, 7179.856402871913, 7188.604626745475, 7191.316824901626, 7204.963975180195, 6893.379595836399, 7000.074979380711, 7000.159980802337, 7004.509684322048, 7025.0, 7821.139674635671, 8047.51714897108, 8107.3108785753875, 8108.675652973815, 8109.148539403278, 8029.839403211786, 8227.958860205661, 8234.505929644241, 8245.051819040887, 8248.793780155544, 6692.130023096966, 6738.292479289604, 6755.695993680394, 6759.188897332351, 6763.086983257197, 7235.782926512213, 7236.0, 7280.235575264521, 7281.963590182015, 7290.161631412456, 6566.507511936719, 6765.188177418741, 6767.120274364301, 6851.725930962705, 6861.931380686129, 6660.666966651745, 6669.0, 6751.662416879235, 6762.391384775394, 6776.695048722918, 6850.177978642595, 6894.724211031703, 6927.134108236471, 6938.930610693828, 6945.888657814726, 6241.095041219089, 6281.183446151971, 6282.277538082996, 6297.748090076529, 6312.905306420315, 6281.214848143982, 6296.0555916612875, 6322.3045464997895, 6342.651154186564, 6386.680665966776], "ext.html": [574.4800955135603, 578.675941472775, 584.0713265907208, 586.2964442668796, 588.9911651325228, 32533.83733081334, 32970.17574560634, 41321.38017929733, 42131.78934105325, 42147.57852421483, 43875.56124438762, 44359.112817743626, 44360.11279774403, 44394.33408498867, 44433.111337773225, 8330.50016998982, 9385.061493850611, 9529.237660987104, 9582.760430989247, 9582.904170958305, 8488.23605875471, 11268.0, 11488.655340339803, 11498.597549085784, 11507.654770356903, 11166.385848778315, 11324.547018119265, 11325.830112548318, 11332.603358882441, 11361.091112710963, 8460.323174146053, 8617.56912154396, 11197.0, 11267.323960562351, 11364.488598013026, 10906.836397454044, 10999.505022274017, 11016.669499915015, 11044.226904116715, 11068.114550835913, 41196.0, 41689.791551042355, 41753.0, 41782.37326440106, 41820.372694409605, 2947.911562653124, 2996.7752418568693, 3002.894898678536, 3009.8043627164166, 3113.143885431502, 28025.43949121006, 28074.0, 28255.717442825513, 28360.0, 28552.857235713895, 2345.6950596422525, 2363.279199844047, 2408.0728919365997, 2408.903643854261, 2505.5114252720728, 297223.0, 302015.0, 302376.0, 303093.0, 303762.0, 57675.0, 58924.41075589275, 61723.691381542805, 62325.0, 62412.0, 60670.0, 61260.387396125465, 61567.69216153891, 61629.69185154135, 61679.07481387783, 16998.405055822986, 17225.1387430628, 17235.91382043082, 17237.224324905408, 17242.568935776704, 12073.396330183456, 12099.939500302442, 12106.636800895987, 12109.818352724717, 12115.939420302842, 20665.17339306411, 21474.463138421354, 21531.13875444996, 21615.891920540296, 21665.78334216669, 9115.951665558414, 9428.575714092882, 9434.90565094354, 9444.574994125282, 9450.810983780286, 924.2882980105416, 1050.3540322701483, 1052.6631477927142, 1101.944902754859, 1115.2304909612342, 29305.267368315537, 29791.0, 29941.251468713457, 32262.838685806422, 33520.66479335175, 1020.6274709731043, 1083.978320433587, 1088.6283283063397, 1098.7637657903429, 1170.9941450292865, 15241.6189595261, 15423.383064677288, 15561.221938903009, 15623.3750649975, 15644.68710625781, 363498.0, 369326.0, 369436.0, 370319.0, 371742.0, 57299.71350143223, 57883.421165787804, 57892.71053644705, 57911.420885790605, 57992.42007579954, 1407.1275808998282, 1416.2847761880184, 1417.4684493315008, 1417.9361928713233, 1436.590571687085, 29486.705132948395, 29956.550651740676, 32955.8352208247, 33224.66775332216, 33327.33345333128, 54445.1833222494, 54986.0, 55056.17415738687, 55058.0, 55082.0, 289900.2019959631, 293417.0, 293674.0, 294774.0, 295137.0, 39217.41173882337, 40069.39895901505, 43349.0, 44300.33549496696, 44906.77546612246, 42430.151396972506, 43427.565724343614, 44426.55573444354, 45034.3244851334, 45875.0, 36760.81619591992, 37994.81002594969, 38847.6115238844, 38887.222255555294, 38963.0, 35636.821815890755, 37214.62785372112, 40742.79628601838, 41386.37920431136, 41867.0, 37638.24723505569, 38078.80960595179, 38801.417978729776, 38838.029049273995, 38887.61112388953, 31823.0, 33899.0, 34063.0, 34070.82964585161, 34084.31831363408, 25426.872865635552, 25834.35414114662, 25858.61212081858, 25868.611970820828, 26121.346966325993], "prototype.html": [303.9650440199377, 315.64805242154995, 316.37358031098427, 321.72974701250945, 323.54057238721015, 5970.373110823366, 6051.243594550681, 6062.030075187965, 6071.78748743794, 6073.362296958822, 5980.162777211183, 5980.700964951746, 5986.431289027546, 5991.520678345732, 6001.849953751158, 4619.769011549409, 4631.143238500888, 4652.97673511632, 4657.2315567931255, 4658.883527911796, 4452.510223875371, 4551.340055691922, 4638.5593368629925, 4643.373144625466, 4648.581627653511, 4490.7530085845265, 4494.168578812913, 4500.257457519506, 4516.345129956155, 4531.524189960056, 4499.0776890737325, 4504.099180163964, 4507.706999045052, 4512.45850497939, 4515.63874890008, 3705.573859006222, 3769.5476542814763, 3814.5422549293985, 3852.0, 3860.034991252187, 5804.970975145097, 5821.0, 5841.240638716939, 5858.619189752652, 5871.618344807616, 4902.338184345103, 4992.350994370745, 5063.620228482841, 5080.466551012164, 5102.413222479426, 6194.0, 6211.81364559064, 6225.906611400833, 6234.563580549363, 6236.563440559163, 4181.498220213563, 4182.811773470201, 4187.476565429321, 4188.518320393163, 4191.601797829201, 6512.023196520512, 6596.406323430866, 6618.172728408949, 6618.635975021371, 6624.205095388536, 4197.433346498245, 4248.553901840324, 4249.426327445817, 4254.659627229814, 4254.744715317091, 4292.313229883266, 4301.591348821857, 4309.5044069932355, 4329.090890912944, 4336.761478118734, 5020.046191223729, 5040.243963405445, 5041.521055499722, 5058.924116138261, 5061.7975280989085, 6127.6936153193055, 6247.0, 6252.09344645033, 6262.780802671976, 6266.467350275278, 1529.6175956010998, 1566.3186513866503, 1568.7019466301367, 1570.089348178054, 1571.1751330551551, 994.9502524873727, 1009.0363702663939, 1014.0771897573173, 1020.8672872526524, 1025.6307729217476, 6098.481629061579, 6125.050617154348, 6129.295131059896, 6135.018397056539, 6150.200473938359, 6579.17760279965, 6590.406863382223, 6597.901031484532, 6613.041109039163, 6615.768448104293, 5959.4934430573885, 6119.388061193845, 6119.785807496805, 6140.3552626974415, 6145.938540614537, 3633.3278343506536, 3657.3416784978426, 3669.119411341259, 3676.3750162472443, 3686.64976827201, 6702.396784289437, 6710.966445167841, 6721.462283017347, 6723.529352945345, 6739.528233023641, 6726.899096513556, 6731.528792984542, 6748.156480439945, 6750.493712971547, 6759.628220447824, 6698.933010669928, 6749.898751518731, 6752.189737231563, 6777.152855893013, 6785.796426107126, 6624.370684784938, 6629.6353700545005, 6643.833904152435, 6668.599884006781, 6674.933250667431, 6315.968420158054, 6478.578892371981, 6484.610923344614, 6501.4798816095545, 6518.641474718936, 6741.056252124805, 6751.831204219934, 6761.0, 6788.321167883172, 6850.314968503109, 4330.588594083557, 4385.693001489993, 4395.0111224974125, 4395.670324725595, 4409.40473036136, 6672.933270667425, 6677.966610166918, 6687.899681504879, 6688.230853451915, 6696.229933557508, 6295.96852015737, 6473.643949582818, 6492.188476440445, 6508.153939987771, 6537.378948999837, 6452.064450654535, 6461.741530338733, 6466.094746735367, 6473.255575608865, 6481.319461456667, 6167.880861938371, 6288.591241569284, 6295.213098362705, 6297.748090076529, 6307.590006649553, 6473.805785826433, 6476.773312934025, 6499.38255865692, 6509.0, 6517.73929042833, 6335.334789847, 6343.619382837044, 6358.459530939922, 6359.554831161774, 6366.427021568081], "yui.html": [693.8508220732541, 726.7674344209852, 759.3166150464584, 774.303127185533, 774.9108852481965, 14170.858291417082, 14200.958849380733, 14356.928215358908, 14381.2809359532, 14403.495877644285, 13354.599362019131, 13495.392707328168, 13536.661583460418, 13551.0, 13565.728685426286, 721.3940290156268, 733.2630706140321, 913.7487191022456, 915.8214148241095, 916.9770755731126, 912.1835956818643, 919.8160367926408, 931.3340961212732, 932.282142750082, 932.9813403731921, 963.8939716631165, 969.1084202533651, 969.8060387922409, 970.112347202309, 970.553545369131, 758.3553979117734, 771.1093686791764, 936.3398803843274, 958.3435346787403, 968.428627110005, 708.2952462299993, 708.3200127877244, 708.3447810775064, 708.3837061756253, 709.6238993333542, 13932.651683707887, 14107.365168567336, 14110.365033573515, 14167.433302667881, 14186.787198192036, 11884.643460696192, 12012.69968250792, 12068.577599783965, 12108.455119519644, 12266.202696824677, 9386.20217281532, 9410.62357505699, 9497.14525692691, 10106.848397274047, 10157.796844063152, 3331.983340083284, 3388.0682812226587, 3419.1793969447403, 3433.9484907726405, 3441.380551500729, 47644.28533571964, 48343.51656483425, 48800.0, 48903.26645100326, 49040.26439603409, 9068.591913363782, 9084.273258139334, 9283.442993420416, 9296.116868897443, 9638.759031024281, 11718.121140914465, 11809.114316426303, 11843.46704398287, 11850.11124165691, 11851.288922664668, 6304.810855674245, 6352.396522330371, 6356.618602883842, 6401.135846660642, 6444.806655800334, 3900.6294402031763, 3944.6647035001774, 4049.7772622505454, 4102.851201663539, 4179.2059508693255, 2570.151849889532, 2591.4687489064695, 2593.6109583562616, 2597.6233446150204, 2597.8960841566127, 386.4165110682833, 393.44917116037203, 396.2392206962639, 397.91643754811815, 401.10553465771494, 505.8586179823265, 512.6539585779658, 516.506736067055, 563.5519761789387, 618.6906546726636, 7792.961035194901, 8137.918620813834, 8139.79650508742, 8756.474611523328, 8833.779155521164, 438.45631417042637, 445.1120015568896, 593.4036293525066, 599.7600959616101, 652.4356431686651, 3671.5227020487164, 3888.5528164261473, 3942.073612701013, 3984.6812255019527, 3996.500437445319, 51454.48545514497, 51546.22680659793, 55397.44602554003, 55790.0, 55966.72016639972, 49589.50410495921, 49945.0, 49980.0, 50029.0, 50042.74978625084, 45478.545214548096, 47651.76174119177, 48406.27390589144, 49224.75387623039, 49354.25968610402, 8391.916080839113, 8416.915830841614, 8441.071482137082, 8621.784455388666, 8694.130586941255, 34936.12659683528, 35549.0, 35868.820655896554, 35929.0, 37039.81480092582, 43205.56794432015, 45826.0, 48275.517244827104, 48307.5169248303, 48551.5144848547, 10427.165826733995, 10517.15862730995, 10736.946315268686, 10821.458927053773, 11194.552217911192, 11112.706815694482, 11150.163737719866, 11222.66332010041, 11338.773224535627, 11370.54517819278, 10586.89413105859, 10723.89276107229, 10999.980135475977, 11353.432328383713, 11497.942510287396, 10449.477526123512, 10730.678079657622, 10835.729106772395, 11003.284786488852, 11329.0, 10491.895081049091, 10588.4705764713, 10800.675979720621, 10822.134229261797, 11405.144614153805, 9144.139650872818, 9199.632014719336, 9212.815743684954, 9586.760330991781, 9633.421994680342, 8616.78458038554, 8964.282857371265, 9079.0, 9532.428054316762, 9557.952210238904]}, "summary": {"suite": 6712.046669010588, "subtests": {"jquery.html": {"filtered": 7234.261784176609, "value": 7234.261784176609}, "dojo.html": {"filtered": 5314.236481177548, "value": 5314.236481177548}, "mootools.html": {"filtered": 4212.76795064407, "value": 4212.76795064407}, "ext.html": {"filtered": 19708.76045938706, "value": 19708.76045938706}, "prototype.html": {"filtered": 4744.87327334037, "value": 4744.87327334037}, "yui.html": {"filtered": 6036.721248947233, "value": 6036.721248947233}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0005"}, "testrun": {"date": 1446771464, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151105145235", "branch": "Firefox", "revision": "dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d"}}, {"talos_counters": {}, "results": {"audio-dft": [161.0, 161.0, 160.0, 161.0, 161.0, 161.0, 162.0, 162.0, 162.0, 159.0], "ai-astar": [106.0, 107.0, 106.0, 110.0, 109.0, 107.0, 100.0, 108.0, 109.0, 108.0], "imaging-gaussian-blur": [120.0, 120.0, 120.0, 119.0, 120.0, 115.0, 115.0, 115.0, 114.0, 120.0], "audio-beat-detection": [162.0, 129.0, 153.0, 163.0, 128.0, 150.0, 148.0, 125.0, 164.0, 128.0], "json-stringify-tinderbox": [66.0, 66.0, 68.0, 67.0, 68.0, 68.0, 68.0, 68.0, 68.0, 67.0], "stanford-crypto-pbkdf2": [149.0, 150.0, 150.0, 148.0, 153.0, 152.0, 150.0, 152.0, 148.0, 143.0], "json-parse-financial": [58.0, 59.0, 57.0, 57.0, 59.0, 59.0, 58.0, 66.0, 56.0, 57.0], "stanford-crypto-sha256-iterative": [70.0, 68.0, 70.0, 69.0, 71.0, 70.0, 69.0, 68.0, 70.0, 72.0], "audio-fft": [73.0, 82.0, 90.0, 85.0, 68.0, 69.0, 69.0, 79.0, 83.0, 66.0], "imaging-darkroom": [126.0, 125.0, 125.0, 124.0, 125.0, 125.0, 125.0, 124.0, 125.0, 124.0], "stanford-crypto-ccm": [126.0, 130.0, 126.0, 123.0, 129.0, 130.0, 134.0, 129.0, 123.0, 122.0], "audio-oscillator": [99.0, 98.0, 136.0, 89.0, 88.0, 89.0, 122.0, 86.0, 87.0, 127.0], "stanford-crypto-aes": [85.0, 85.0, 84.0, 86.0, 85.0, 86.0, 85.0, 85.0, 85.0, 85.0], "imaging-desaturate": [100.0, 100.0, 100.0, 101.0, 101.0, 101.0, 100.0, 100.0, 101.0, 101.0]}, "summary": {"suite": 1492.1, "subtests": {"audio-fft": {"filtered": 76.4, "value": 76.4}, "stanford-crypto-pbkdf2": {"filtered": 149.5, "value": 149.5}, "audio-beat-detection": {"filtered": 145.0, "value": 145.0}, "stanford-crypto-ccm": {"filtered": 127.2, "value": 127.2}, "imaging-darkroom": {"filtered": 124.8, "value": 124.8}, "json-parse-financial": {"filtered": 58.6, "value": 58.6}, "audio-oscillator": {"filtered": 102.1, "value": 102.1}, "ai-astar": {"filtered": 107.0, "value": 107.0}, "audio-dft": {"filtered": 161.0, "value": 161.0}, "stanford-crypto-sha256-iterative": {"filtered": 69.7, "value": 69.7}, "json-stringify-tinderbox": {"filtered": 67.4, "value": 67.4}, "imaging-gaussian-blur": {"filtered": 117.8, "value": 117.8}, "stanford-crypto-aes": {"filtered": 85.1, "value": 85.1}, "imaging-desaturate": {"filtered": 100.5, "value": 100.5}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0005"}, "testrun": {"date": 1446771464, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151105145235", "branch": "Firefox", "revision": "dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d"}}, {"talos_counters": {}, "results": {"DeltaBlue": [191.46084625694044], "Encrypt": [324.5699448231094], "NavierStokes": [5797.687861271676], "Decrypt": [5758.620689655172], "Splay": [721.1404728789986], "Richards": [166.22340425531914], "RegExp": [28500.0], "Earley": [908.2652134423251], "Boyer": [12370.37037037037], "RayTrace": [2059.670781893004]}, "summary": {"suite": 18114.607684956132, "subtests": {"DeltaBlue": {"filtered": 345.33431399999995, "value": 345.33431399999995}, "Encrypt": {"filtered": 820.1036610000003, "value": 820.1036610000003}, "NavierStokes": {"filtered": 255.96410767696923, "value": 255.96410767696923}, "Decrypt": {"filtered": 46.22304790419163, "value": 46.22304790419163}, "Splay": {"filtered": 113.00294889103188, "value": 113.00294889103188}, "RegExp": {"filtered": 31.96438596491228, "value": 31.96438596491228}, "Richards": {"filtered": 212.37683199999995, "value": 212.37683199999995}, "Earley": {"filtered": 733.7757630000001, "value": 733.7757630000001}, "Boyer": {"filtered": 53.87575149700595, "value": 53.87575149700595}, "RayTrace": {"filtered": 359.27537862137854, "value": 359.27537862137854}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0005"}, "testrun": {"date": 1446771464, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151105145235", "branch": "Firefox", "revision": "dae6c2b8fef8a2f504baab5dae7ccd59d57a1d9d"}}] 17:17:52 INFO - RETURN: dromaeo_css: 6712.05 17:17:52 INFO - RETURN: kraken: 1492.10 17:17:52 INFO - RETURN: v8_7: 18114.61 17:17:52 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,1,55]]", "result": "18114.61"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,55]]", "result": "1492.10"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,55]]", "result": "6712.05"}}} 17:17:52 INFO - Return code: 0 17:17:52 INFO - # TBPL SUCCESS # 17:17:52 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:17:52 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:17:52 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:17:52 INFO - 2015-11-05 17:17:52.996 screenresolution[6430:120011] starting screenresolution argv=screenresolution get 17:17:52 INFO - 2015-11-05 17:17:52.999 screenresolution[6430:120011] Display 0: 1600x1200x32@60 17:17:53 INFO - 2015-11-05 17:17:53.005 screenresolution[6431:120014] starting screenresolution argv=screenresolution list 17:17:53 INFO - Available Modes on Display 0 17:17:53 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:17:53 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:17:53 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:17:53 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:17:53 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:17:53 INFO - Intel HD Graphics 3000: 17:17:53 INFO - Chipset Model: Intel HD Graphics 3000 17:17:53 INFO - Type: GPU 17:17:53 INFO - Bus: Built-In 17:17:53 INFO - VRAM (Total): 512 MB 17:17:53 INFO - VRAM (Dynamic, Max): 10 17:17:53 INFO - Vendor: Intel (0x8086) 17:17:53 INFO - Device ID: 0x0116 17:17:53 INFO - Revision ID: 0x0009 17:17:53 INFO - Displays: 17:17:53 INFO - Display: 17:17:53 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:17:53 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:17:53 INFO - Display Serial Number: 1600x1200 60 17:17:53 INFO - Main Display: Yes 17:17:53 INFO - Mirror: Off 17:17:53 INFO - Online: Yes 17:17:53 INFO - Rotation: Supported 17:17:53 INFO - Return code: 0 17:17:53 INFO - Running post-action listener: _resource_record_post_action 17:17:53 INFO - Running post-run listener: _resource_record_post_run 17:17:54 INFO - Total resource usage - Wall time: 1244s; CPU: 30.0%; Read bytes: 2400256; Write bytes: 684399616; Read time: 499; Write time: 14793 17:17:54 INFO - install - Wall time: 36s; CPU: 30.0%; Read bytes: 336640512; Write bytes: 335116288; Read time: 30605; Write time: 3435 17:17:54 INFO - run-tests - Wall time: 1209s; CPU: 30.0%; Read bytes: 2400256; Write bytes: 338097152; Read time: 499; Write time: 11064 17:17:54 INFO - Running post-run listener: _upload_blobber_files 17:17:54 INFO - Blob upload gear active. 17:17:54 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 17:17:54 INFO - Copying logs to upload dir... 17:17:54 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1336.543665 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 16 secs) (at 2015-11-05 17:17:54.412257) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-05 17:17:54.416019) ========= 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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners TMPDIR=/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010030 build_url: 'https://queue.taskcluster.net/v1/task/_B79ag_ZSEuxANtXAKWfVQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-05 17:17:54.441779) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 17:17:54.442133) ========= 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.vxTgoI5Q9O/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.GGMAI5AMvw/Listeners TMPDIR=/var/folders/g9/ny3dcy5d1f50fbskw_l889z000000w/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.005275 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 17:17:54.491522) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-05 17:17:54.491893) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-05 17:17:54.492292) ========= ========= Total master_lag: 0.22 =========