builder: fx-team_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0035 starttime: 1470925447.57 results: success (0) buildid: 20160811041522 builduid: 55130c828f034769b55c8ecbc0e7a465 revision: 39fdb9c2017e96940075926234809cef0f8b5f1b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:07.567878) ========= master: http://buildbot-master133.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:07.568293) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:07.568579) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:07.624810) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:07.625105) ========= 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.all9v01wS1/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.Z1RQAvTd8p/Listeners TMPDIR=/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-08-11 07:24:07-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 17.3M=0.001s 2016-08-11 07:24:08 (17.3 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.511334 ========= master_lag: 0.07 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:08.207652) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:08.211457) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners TMPDIR=/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.028188 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:08.298297) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-11 07:24:08.298618) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 39fdb9c2017e96940075926234809cef0f8b5f1b --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 39fdb9c2017e96940075926234809cef0f8b5f1b --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners TMPDIR=/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-08-11 07:24:08,411 truncating revision to first 12 chars 2016-08-11 07:24:08,411 Setting DEBUG logging. 2016-08-11 07:24:08,411 attempt 1/10 2016-08-11 07:24:08,411 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/39fdb9c2017e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-11 07:24:09,109 unpacking tar archive at: fx-team-39fdb9c2017e/testing/mozharness/ program finished with exit code 0 elapsedTime=0.959443 ========= master_lag: 0.13 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-11 07:24:09.391602) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:09.391877) ========= script_repo_revision: 39fdb9c2017e96940075926234809cef0f8b5f1b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:09.392302) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:09.392625) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-11 07:24:09.469097) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2016-08-11 07:24:09.469384) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners TMPDIR=/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 07:24:09 INFO - MultiFileLogger online at 20160811 07:24:09 in /builds/slave/test 07:24:09 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 07:24:09 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:24:09 INFO - {'append_to_log': False, 07:24:09 INFO - 'base_work_dir': '/builds/slave/test', 07:24:09 INFO - 'blob_upload_branch': 'Fx-Team', 07:24:09 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:24:09 INFO - 'branch': 'Fx-Team', 07:24:09 INFO - 'buildbot_json_path': 'buildprops.json', 07:24:09 INFO - 'config_files': ('talos/mac_config.py',), 07:24:09 INFO - 'default_actions': ('clobber', 07:24:09 INFO - 'read-buildbot-config', 07:24:09 INFO - 'download-and-extract', 07:24:09 INFO - 'populate-webroot', 07:24:09 INFO - 'create-virtualenv', 07:24:09 INFO - 'install', 07:24:09 INFO - 'run-tests'), 07:24:09 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:24:09 INFO - 'download_minidump_stackwalk': True, 07:24:09 INFO - 'download_symbols': 'ondemand', 07:24:09 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:24:09 INFO - 'tooltool.py': '/tools/tooltool.py', 07:24:09 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:24:09 INFO - '/tools/misc-python/virtualenv.py')}, 07:24:09 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:24:09 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:24:09 INFO - 'installer_path': 'installer.exe', 07:24:09 INFO - 'log_level': 'info', 07:24:09 INFO - 'log_name': 'talos', 07:24:09 INFO - 'log_to_console': True, 07:24:09 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 07:24:09 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 07:24:09 INFO - 'opt_config_files': (), 07:24:09 INFO - 'pip_index': False, 07:24:09 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 07:24:09 INFO - 'cmd': ('bash', 07:24:09 INFO - '-c', 07:24:09 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 07:24:09 INFO - 'enabled': True, 07:24:09 INFO - 'halt_on_failure': False, 07:24:09 INFO - 'name': 'check_screen_resolution'},), 07:24:09 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 07:24:09 INFO - 'cmd': ('bash', 07:24:09 INFO - '-c', 07:24:09 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 07:24:09 INFO - 'enabled': True, 07:24:09 INFO - 'halt_on_failure': False, 07:24:09 INFO - 'name': 'check_screen_resolution'},), 07:24:09 INFO - 'run_cmd_checks_enabled': True, 07:24:09 INFO - 'sps_profile': False, 07:24:09 INFO - 'sps_profile_interval': 0, 07:24:09 INFO - 'suite': 'dromaeojs-e10s', 07:24:09 INFO - 'system_bits': '32', 07:24:09 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:24:09 INFO - 'title': 't-yosemite-r7-0035', 07:24:09 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:24:09 INFO - 'use_talos_json': True, 07:24:09 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:24:09 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:24:09 INFO - 'work_dir': 'build'} 07:24:09 INFO - [mozharness: 2016-08-11 14:24:09.663322Z] Running clobber step. 07:24:09 INFO - Running pre-action listener: _resource_record_pre_action 07:24:09 INFO - Running main action method: clobber 07:24:09 INFO - rmtree: /builds/slave/test/build 07:24:09 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:24:11 INFO - Running post-action listener: _resource_record_post_action 07:24:11 INFO - [mozharness: 2016-08-11 14:24:11.765439Z] Finished clobber step (success) 07:24:11 INFO - [mozharness: 2016-08-11 14:24:11.765707Z] Running read-buildbot-config step. 07:24:11 INFO - Running pre-action listener: _resource_record_pre_action 07:24:11 INFO - Running main action method: read_buildbot_config 07:24:11 INFO - Using buildbot properties: 07:24:11 INFO - { 07:24:11 INFO - "project": "", 07:24:11 INFO - "product": "firefox", 07:24:11 INFO - "script_repo_revision": "production", 07:24:11 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs-e10s", 07:24:11 INFO - "repository": "", 07:24:11 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs-e10s", 07:24:11 INFO - "buildid": "20160811041522", 07:24:11 INFO - "pgo_build": "False", 07:24:11 INFO - "basedir": "/builds/slave/test", 07:24:11 INFO - "buildnumber": 76, 07:24:11 INFO - "slavename": "t-yosemite-r7-0035", 07:24:11 INFO - "master": "http://buildbot-master133.bb.releng.scl3.mozilla.com:8201/", 07:24:11 INFO - "platform": "yosemite_r7", 07:24:11 INFO - "scheduler": "tests-fx-team-macosx64-talos-7-3600", 07:24:11 INFO - "branch": "fx-team", 07:24:11 INFO - "repo_path": "integration/fx-team", 07:24:11 INFO - "revision": "39fdb9c2017e96940075926234809cef0f8b5f1b", 07:24:11 INFO - "stage_platform": "macosx64", 07:24:11 INFO - "builduid": "55130c828f034769b55c8ecbc0e7a465", 07:24:11 INFO - "slavebuilddir": "test" 07:24:11 INFO - } 07:24:11 INFO - Found installer url https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg. 07:24:11 INFO - Running post-action listener: _resource_record_post_action 07:24:11 INFO - [mozharness: 2016-08-11 14:24:11.772489Z] Finished read-buildbot-config step (success) 07:24:11 INFO - [mozharness: 2016-08-11 14:24:11.772858Z] Running download-and-extract step. 07:24:11 INFO - Running pre-action listener: _resource_record_pre_action 07:24:11 INFO - Running main action method: download_and_extract 07:24:11 INFO - mkdir: /builds/slave/test/build/tests 07:24:11 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:11 INFO - trying https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json 07:24:11 INFO - Downloading https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 07:24:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json'}, attempt #1 07:24:12 INFO - Downloaded 1199 bytes. 07:24:12 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 07:24:12 INFO - Using the following test package requirements: 07:24:12 INFO - {u'common': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 07:24:12 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 07:24:12 INFO - u'firefox-51.0a1.en-US.mac.cppunittest.tests.zip'], 07:24:12 INFO - u'gtest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 07:24:12 INFO - u'firefox-51.0a1.en-US.mac.gtest.tests.zip'], 07:24:12 INFO - u'jittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 07:24:12 INFO - u'jsshell-mac.zip'], 07:24:12 INFO - u'mochitest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 07:24:12 INFO - u'firefox-51.0a1.en-US.mac.mochitest.tests.zip'], 07:24:12 INFO - u'mozbase': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 07:24:12 INFO - u'reftest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 07:24:12 INFO - u'firefox-51.0a1.en-US.mac.reftest.tests.zip'], 07:24:12 INFO - u'talos': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 07:24:12 INFO - u'firefox-51.0a1.en-US.mac.talos.tests.zip'], 07:24:12 INFO - u'web-platform': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 07:24:12 INFO - u'firefox-51.0a1.en-US.mac.web-platform.tests.zip'], 07:24:12 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 07:24:12 INFO - u'firefox-51.0a1.en-US.mac.xpcshell.tests.zip']} 07:24:12 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip'] for test suite category: common 07:24:12 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:12 INFO - trying https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 07:24:12 INFO - Downloading https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip 07:24:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip'}, attempt #1 07:24:13 INFO - Downloaded 16328378 bytes. 07:24:13 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:24:13 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 07:24:16 INFO - Return code: 0 07:24:16 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip', u'firefox-51.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 07:24:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:16 INFO - trying https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 07:24:16 INFO - Downloading https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip 07:24:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip'}, attempt #1 07:24:17 INFO - Downloaded 16328378 bytes. 07:24:17 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:24:17 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 07:24:21 INFO - Return code: 0 07:24:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:21 INFO - trying https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip 07:24:21 INFO - Downloading https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip 07:24:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip'}, attempt #1 07:24:23 INFO - Downloaded 14413719 bytes. 07:24:23 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:24:23 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 07:24:24 INFO - Return code: 0 07:24:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:24 INFO - trying https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 07:24:24 INFO - Downloading https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg 07:24:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg'}, attempt #1 07:24:28 INFO - Downloaded 110896919 bytes. 07:24:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 07:24:28 INFO - mkdir: /builds/slave/test/properties 07:24:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:24:28 INFO - Writing to file /builds/slave/test/properties/build_url 07:24:28 INFO - Contents: 07:24:28 INFO - build_url:https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 07:24:28 INFO - Running post-action listener: _resource_record_post_action 07:24:28 INFO - Running post-action listener: set_extra_try_arguments 07:24:28 INFO - [mozharness: 2016-08-11 14:24:28.832384Z] Finished download-and-extract step (success) 07:24:28 INFO - [mozharness: 2016-08-11 14:24:28.832519Z] Running populate-webroot step. 07:24:28 INFO - Running pre-action listener: _resource_record_pre_action 07:24:28 INFO - Running main action method: populate_webroot 07:24:28 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:24:28 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:24:28 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:24:28 INFO - '--tppagecycles', 07:24:28 INFO - '7'], 07:24:28 INFO - 'tests': ['tsvgm']}}, 07:24:28 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:24:28 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 07:24:28 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:24:28 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 07:24:28 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:24:28 INFO - 'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:24:28 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:24:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:24:28 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:24:28 INFO - 'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['damp', 'tps']}, 07:24:28 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:24:28 INFO - 'tests': ['damp', 'tps']}, 07:24:28 INFO - 'g3': {'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['dromaeo_dom']}, 07:24:28 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:24:28 INFO - 'g4': {'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['basic_compositor_video']}, 07:24:28 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 07:24:28 INFO - 'other': {'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['a11yr', 07:24:28 INFO - 'ts_paint', 07:24:28 INFO - 'tpaint', 07:24:28 INFO - 'sessionrestore', 07:24:28 INFO - 'sessionrestore_no_auto_restore', 07:24:28 INFO - 'tabpaint']}, 07:24:28 INFO - 'other-e10s': {'tests': ['a11yr', 07:24:28 INFO - 'ts_paint', 07:24:28 INFO - 'tpaint', 07:24:28 INFO - 'sessionrestore', 07:24:28 INFO - 'sessionrestore_no_auto_restore', 07:24:28 INFO - 'tabpaint']}, 07:24:28 INFO - 'other-e10s_l64': {'tests': ['a11yr', 07:24:28 INFO - 'ts_paint', 07:24:28 INFO - 'tpaint', 07:24:28 INFO - 'sessionrestore', 07:24:28 INFO - 'sessionrestore_no_auto_restore', 07:24:28 INFO - 'tabpaint']}, 07:24:28 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 07:24:28 INFO - 'ts_paint', 07:24:28 INFO - 'tpaint', 07:24:28 INFO - 'sessionrestore', 07:24:28 INFO - 'sessionrestore_no_auto_restore', 07:24:28 INFO - 'tabpaint']}, 07:24:28 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['a11yr', 07:24:28 INFO - 'ts_paint', 07:24:28 INFO - 'tpaint', 07:24:28 INFO - 'sessionrestore', 07:24:28 INFO - 'sessionrestore_no_auto_restore', 07:24:28 INFO - 'tabpaint']}, 07:24:28 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['a11yr', 07:24:28 INFO - 'ts_paint', 07:24:28 INFO - 'tpaint', 07:24:28 INFO - 'sessionrestore', 07:24:28 INFO - 'sessionrestore_no_auto_restore', 07:24:28 INFO - 'tabpaint']}, 07:24:28 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['tsvgx', 07:24:28 INFO - 'tsvgr_opacity', 07:24:28 INFO - 'tart', 07:24:28 INFO - 'tscrollx', 07:24:28 INFO - 'cart']}, 07:24:28 INFO - 'svgr-e10s': {'tests': ['tsvgx', 07:24:28 INFO - 'tsvgr_opacity', 07:24:28 INFO - 'tart', 07:24:28 INFO - 'tscrollx', 07:24:28 INFO - 'cart']}, 07:24:28 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:24:28 INFO - 'talos_options': ['--disable-e10s'], 07:24:28 INFO - 'tests': ['tp5o']}, 07:24:28 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:24:28 INFO - 'tests': ['tp5o']}, 07:24:28 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:24:28 INFO - 'talos_options': ['--disable-e10s', 07:24:28 INFO - '--xperf_path', 07:24:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:24:28 INFO - 'tests': ['tp5n']}, 07:24:28 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:24:28 INFO - 'talos_options': ['--xperf_path', 07:24:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:24:28 INFO - 'tests': ['tp5n']}}, 07:24:28 INFO - 'talos.zip': {'path': '', 07:24:28 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:24:28 INFO - Running post-action listener: _resource_record_post_action 07:24:28 INFO - [mozharness: 2016-08-11 14:24:28.851491Z] Finished populate-webroot step (success) 07:24:28 INFO - [mozharness: 2016-08-11 14:24:28.851601Z] Running create-virtualenv step. 07:24:28 INFO - Running pre-action listener: _resource_record_pre_action 07:24:28 INFO - Running main action method: create_virtualenv 07:24:28 INFO - Creating virtualenv /builds/slave/test/build/venv 07:24:28 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 07:24:28 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:24:28 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:24:28 INFO - Using real prefix '/tools/python27' 07:24:28 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:24:29 INFO - Installing distribute.............................................................................................................................................................................................done. 07:24:32 INFO - Installing pip.................done. 07:24:32 INFO - Return code: 0 07:24:32 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:24:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 07:24:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:24:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:32 INFO - 'HOME': '/Users/cltbld', 07:24:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:32 INFO - 'LOGNAME': 'cltbld', 07:24:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:32 INFO - 'MOZ_NO_REMOTE': '1', 07:24:32 INFO - 'NO_EM_RESTART': '1', 07:24:32 INFO - 'PAGER': '/bin/cat', 07:24:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:32 INFO - 'PWD': '/builds/slave/test', 07:24:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:32 INFO - 'SHELL': '/bin/bash', 07:24:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:32 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:32 INFO - 'USER': 'cltbld', 07:24:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:32 INFO - 'XPC_FLAGS': '0x0', 07:24:32 INFO - 'XPC_SERVICE_NAME': '0', 07:24:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:32 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 07:24:32 INFO - Cleaning up... 07:24:32 INFO - Return code: 0 07:24:32 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 07:24:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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>=3.1.1'] in /builds/slave/test/build 07:24:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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>=3.1.1 07:24:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:32 INFO - 'HOME': '/Users/cltbld', 07:24:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:32 INFO - 'LOGNAME': 'cltbld', 07:24:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:32 INFO - 'MOZ_NO_REMOTE': '1', 07:24:32 INFO - 'NO_EM_RESTART': '1', 07:24:32 INFO - 'PAGER': '/bin/cat', 07:24:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:32 INFO - 'PWD': '/builds/slave/test', 07:24:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:32 INFO - 'SHELL': '/bin/bash', 07:24:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:32 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:32 INFO - 'USER': 'cltbld', 07:24:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:32 INFO - 'XPC_FLAGS': '0x0', 07:24:32 INFO - 'XPC_SERVICE_NAME': '0', 07:24:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:33 INFO - Downloading/unpacking psutil>=3.1.1 07:24:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:24:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:24:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:24:36 INFO - Installing collected packages: psutil 07:24:36 INFO - Running setup.py install for psutil 07:24:36 INFO - building 'psutil._psutil_osx' extension 07:24:36 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 07:24:37 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 07:24:37 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 07:24:37 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 07:24:37 INFO - building 'psutil._psutil_posix' extension 07:24:37 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 07:24:37 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 07:24:37 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 07:24:37 INFO - ^ 07:24:37 INFO - 1 warning generated. 07:24:37 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 07:24:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:24:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:24:37 INFO - Successfully installed psutil 07:24:37 INFO - Cleaning up... 07:24:37 INFO - Return code: 0 07:24:37 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 07:24:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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.3'] in /builds/slave/test/build 07:24:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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.3 07:24:37 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:37 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:37 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:37 INFO - 'HOME': '/Users/cltbld', 07:24:37 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:37 INFO - 'LOGNAME': 'cltbld', 07:24:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:37 INFO - 'MOZ_NO_REMOTE': '1', 07:24:37 INFO - 'NO_EM_RESTART': '1', 07:24:37 INFO - 'PAGER': '/bin/cat', 07:24:37 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:37 INFO - 'PWD': '/builds/slave/test', 07:24:37 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:37 INFO - 'SHELL': '/bin/bash', 07:24:37 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:37 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:37 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:37 INFO - 'USER': 'cltbld', 07:24:37 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:37 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:37 INFO - 'XPC_FLAGS': '0x0', 07:24:37 INFO - 'XPC_SERVICE_NAME': '0', 07:24:37 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:37 INFO - Downloading/unpacking mozsystemmonitor==0.3 07:24:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:40 INFO - Downloading mozsystemmonitor-0.3.tar.gz 07:24:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 07:24:40 INFO - Installing collected packages: mozsystemmonitor 07:24:40 INFO - Running setup.py install for mozsystemmonitor 07:24:40 INFO - Successfully installed mozsystemmonitor 07:24:40 INFO - Cleaning up... 07:24:40 INFO - Return code: 0 07:24:40 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 07:24:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema==2.5.1'] in /builds/slave/test/build 07:24:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 jsonschema==2.5.1 07:24:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:40 INFO - 'HOME': '/Users/cltbld', 07:24:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:40 INFO - 'LOGNAME': 'cltbld', 07:24:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:40 INFO - 'MOZ_NO_REMOTE': '1', 07:24:40 INFO - 'NO_EM_RESTART': '1', 07:24:40 INFO - 'PAGER': '/bin/cat', 07:24:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:40 INFO - 'PWD': '/builds/slave/test', 07:24:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:40 INFO - 'SHELL': '/bin/bash', 07:24:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:40 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:40 INFO - 'USER': 'cltbld', 07:24:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:40 INFO - 'XPC_FLAGS': '0x0', 07:24:40 INFO - 'XPC_SERVICE_NAME': '0', 07:24:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:40 INFO - Downloading/unpacking jsonschema==2.5.1 07:24:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:43 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:24:43 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 07:24:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:43 INFO - Downloading functools32-3.2.3-2.tar.gz 07:24:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:24:43 INFO - warning: no files found matching '*.txt' 07:24:43 INFO - no previously-included directories found matching 'build' 07:24:43 INFO - no previously-included directories found matching 'dist' 07:24:43 INFO - no previously-included directories found matching '.git*' 07:24:43 INFO - Installing collected packages: jsonschema, functools32 07:24:43 INFO - Running setup.py install for functools32 07:24:43 INFO - warning: no files found matching '*.txt' 07:24:43 INFO - no previously-included directories found matching 'build' 07:24:43 INFO - no previously-included directories found matching 'dist' 07:24:43 INFO - no previously-included directories found matching '.git*' 07:24:44 INFO - Successfully installed jsonschema functools32 07:24:44 INFO - Cleaning up... 07:24:44 INFO - Return code: 0 07:24:44 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 07:24: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'functools32==3.2.3-2'] in /builds/slave/test/build 07:24:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 functools32==3.2.3-2 07:24:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:44 INFO - 'HOME': '/Users/cltbld', 07:24:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:44 INFO - 'LOGNAME': 'cltbld', 07:24:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:44 INFO - 'MOZ_NO_REMOTE': '1', 07:24:44 INFO - 'NO_EM_RESTART': '1', 07:24:44 INFO - 'PAGER': '/bin/cat', 07:24:44 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:44 INFO - 'PWD': '/builds/slave/test', 07:24:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:44 INFO - 'SHELL': '/bin/bash', 07:24:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:44 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:44 INFO - 'USER': 'cltbld', 07:24:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:44 INFO - 'XPC_FLAGS': '0x0', 07:24:44 INFO - 'XPC_SERVICE_NAME': '0', 07:24:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:44 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 07:24:44 INFO - Cleaning up... 07:24:44 INFO - Return code: 0 07:24:44 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:24: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 07:24:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 07:24:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:44 INFO - 'HOME': '/Users/cltbld', 07:24:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:44 INFO - 'LOGNAME': 'cltbld', 07:24:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:44 INFO - 'MOZ_NO_REMOTE': '1', 07:24:44 INFO - 'NO_EM_RESTART': '1', 07:24:44 INFO - 'PAGER': '/bin/cat', 07:24:44 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:44 INFO - 'PWD': '/builds/slave/test', 07:24:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:44 INFO - 'SHELL': '/bin/bash', 07:24:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:44 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:44 INFO - 'USER': 'cltbld', 07:24:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:44 INFO - 'XPC_FLAGS': '0x0', 07:24:44 INFO - 'XPC_SERVICE_NAME': '0', 07:24:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:44 INFO - Downloading/unpacking blobuploader==1.2.4 07:24:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:24:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:24:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:24:47 INFO - Downloading blobuploader-1.2.4.tar.gz 07:24:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:24:47 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:24: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 07:24: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 07:24: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 07:24: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 07:24: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 07:24: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 07:24:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:24:47 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:24: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 07:24: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 07:24: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 07:24: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 07:24: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 07:24: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 07:24:48 INFO - Downloading docopt-0.6.1.tar.gz 07:24:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:24:48 INFO - Installing collected packages: blobuploader, requests, docopt 07:24:48 INFO - Running setup.py install for blobuploader 07:24:48 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:24:48 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:24:48 INFO - Running setup.py install for requests 07:24:48 INFO - Running setup.py install for docopt 07:24:49 INFO - Successfully installed blobuploader requests docopt 07:24:49 INFO - Cleaning up... 07:24:49 INFO - Return code: 0 07:24:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:24:49 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:49 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 07:24:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:24:49 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:49 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:49 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:49 INFO - 'HOME': '/Users/cltbld', 07:24:49 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:49 INFO - 'LOGNAME': 'cltbld', 07:24:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:49 INFO - 'MOZ_NO_REMOTE': '1', 07:24:49 INFO - 'NO_EM_RESTART': '1', 07:24:49 INFO - 'PAGER': '/bin/cat', 07:24:49 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:49 INFO - 'PWD': '/builds/slave/test', 07:24:49 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:49 INFO - 'SHELL': '/bin/bash', 07:24:49 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:49 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:49 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:49 INFO - 'USER': 'cltbld', 07:24:49 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:49 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:49 INFO - 'XPC_FLAGS': '0x0', 07:24:49 INFO - 'XPC_SERVICE_NAME': '0', 07:24:49 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:24:49 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-jKgL8J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:24:49 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-zDXFCL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:24:49 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-fXgcnw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:24:49 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-D1i5nQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:24:49 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-dSudCu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:24:49 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-Z4rJRO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-njpmMk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-i_u2mB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-7r4zTz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-nXRatV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-Q44QwV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-d3N1Mi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-j2Q_fy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-Xs4PQw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:24:50 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-NWGpvh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:24:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:24:51 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-jrEyuD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:24:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:24:51 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-i8Cne1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:24:51 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:24:51 INFO - Running setup.py install for manifestparser 07:24:51 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:24:51 INFO - Running setup.py install for mozcrash 07:24:51 INFO - Running setup.py install for mozdebug 07:24:51 INFO - Running setup.py install for mozdevice 07:24:51 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:24:51 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:24:51 INFO - Running setup.py install for mozfile 07:24:51 INFO - Running setup.py install for mozhttpd 07:24:52 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:24:52 INFO - Running setup.py install for mozinfo 07:24:52 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:24:52 INFO - Running setup.py install for mozInstall 07:24:52 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:24:52 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:24:52 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:24:52 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:24:52 INFO - Running setup.py install for mozleak 07:24:52 INFO - Running setup.py install for mozlog 07:24:52 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:24:52 INFO - Running setup.py install for moznetwork 07:24:52 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:24:52 INFO - Running setup.py install for mozprocess 07:24:53 INFO - Running setup.py install for mozprofile 07:24:53 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:24:53 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:24:53 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:24:53 INFO - Running setup.py install for mozrunner 07:24:53 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:24:53 INFO - Running setup.py install for mozscreenshot 07:24:53 INFO - Running setup.py install for moztest 07:24:53 INFO - Running setup.py install for mozversion 07:24:53 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:24:53 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:24:53 INFO - Cleaning up... 07:24:53 INFO - Return code: 0 07:24:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:24: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 07:24:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:24:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:53 INFO - 'HOME': '/Users/cltbld', 07:24:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:53 INFO - 'LOGNAME': 'cltbld', 07:24:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:53 INFO - 'MOZ_NO_REMOTE': '1', 07:24:53 INFO - 'NO_EM_RESTART': '1', 07:24:53 INFO - 'PAGER': '/bin/cat', 07:24:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:53 INFO - 'PWD': '/builds/slave/test', 07:24:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:53 INFO - 'SHELL': '/bin/bash', 07:24:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:53 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:53 INFO - 'USER': 'cltbld', 07:24:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:53 INFO - 'XPC_FLAGS': '0x0', 07:24:53 INFO - 'XPC_SERVICE_NAME': '0', 07:24:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-8ewMtz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:24:54 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-oYOK1T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:24:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-G5uyvL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:24:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-BZPFQb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:24:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-qaABJA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:24:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-3d4UKK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:24:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-xbvwXI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:24:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-Vm2WrT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:24:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 07:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:24:54 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-Rs2ASp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 07:24:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:24:55 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-qelG5D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:24:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:24:55 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-lHcPro-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 07:24:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:24:55 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-xAPhtt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 07:24:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:24:55 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-ihBTci-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 07:24:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:24:55 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-fW8gy4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 07:24:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:24:55 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-AY5ppN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 07:24:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:24:55 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-asD9NT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 07:24:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:24:55 INFO - Running setup.py (path:/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/pip-TF5Neb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 07:24:55 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:24:55 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:24:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 07:24:55 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:24:55 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:24:55 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:24: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 07:24: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 07:24: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 07:24: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 07:24: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 07:24: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 07:24:58 INFO - Downloading blessings-1.6.tar.gz 07:24:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:24:58 INFO - Installing collected packages: blessings 07:24:58 INFO - Running setup.py install for blessings 07:24:58 INFO - Successfully installed blessings 07:24:58 INFO - Cleaning up... 07:24:58 INFO - Return code: 0 07:24:58 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:24:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:24:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:24:58 INFO - Reading from file tmpfile_stdout 07:24:58 INFO - Current package versions: 07:24:58 INFO - blessings == 1.6 07:24:58 INFO - blobuploader == 1.2.4 07:24:58 INFO - docopt == 0.6.1 07:24:58 INFO - functools32 == 3.2.3-2 07:24:58 INFO - jsonschema == 2.5.1 07:24:58 INFO - manifestparser == 1.1 07:24:58 INFO - mozInstall == 1.12 07:24:58 INFO - mozcrash == 0.17 07:24:58 INFO - mozdebug == 0.1 07:24:58 INFO - mozdevice == 0.48 07:24:58 INFO - mozfile == 1.2 07:24:58 INFO - mozhttpd == 0.7 07:24:58 INFO - mozinfo == 0.9 07:24:58 INFO - mozleak == 0.1 07:24:58 INFO - mozlog == 3.3 07:24:58 INFO - moznetwork == 0.27 07:24:58 INFO - mozprocess == 0.23 07:24:58 INFO - mozprofile == 0.28 07:24:58 INFO - mozrunner == 6.12 07:24:58 INFO - mozscreenshot == 0.1 07:24:58 INFO - mozsystemmonitor == 0.3 07:24:58 INFO - moztest == 0.7 07:24:58 INFO - mozversion == 1.4 07:24:58 INFO - psutil == 3.1.1 07:24:58 INFO - requests == 1.2.3 07:24:58 INFO - wsgiref == 0.1.2 07:24:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:24: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 07:24:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:24:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:58 INFO - 'HOME': '/Users/cltbld', 07:24:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:58 INFO - 'LOGNAME': 'cltbld', 07:24:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:58 INFO - 'MOZ_NO_REMOTE': '1', 07:24:58 INFO - 'NO_EM_RESTART': '1', 07:24:58 INFO - 'PAGER': '/bin/cat', 07:24:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:58 INFO - 'PWD': '/builds/slave/test', 07:24:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:58 INFO - 'SHELL': '/bin/bash', 07:24:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:58 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:58 INFO - 'USER': 'cltbld', 07:24:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:58 INFO - 'XPC_FLAGS': '0x0', 07:24:58 INFO - 'XPC_SERVICE_NAME': '0', 07:24:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 07:24:59 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 2)) 07:24:59 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 3)) 07:24:59 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 4)) 07:24:59 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 5)) 07:24:59 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 6)) 07:24:59 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 7)) 07:24:59 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 8)) 07:24:59 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 9)) 07:24:59 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.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 07:24:59 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 4)) 07:24:59 INFO - Cleaning up... 07:24:59 INFO - Return code: 0 07:24:59 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:24:59 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:24:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:59 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:24:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:24:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:24:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b5da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108bf2618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc78b4b8770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/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.Z1RQAvTd8p/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 07:24:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema'] in /builds/slave/test/build 07:24:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 jsonschema 07:24:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:24:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:24:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:24:59 INFO - 'HOME': '/Users/cltbld', 07:24:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:24:59 INFO - 'LOGNAME': 'cltbld', 07:24:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:24:59 INFO - 'MOZ_NO_REMOTE': '1', 07:24:59 INFO - 'NO_EM_RESTART': '1', 07:24:59 INFO - 'PAGER': '/bin/cat', 07:24:59 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:24:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:24:59 INFO - 'PWD': '/builds/slave/test', 07:24:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:24:59 INFO - 'SHELL': '/bin/bash', 07:24:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:24:59 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:24:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:24:59 INFO - 'USER': 'cltbld', 07:24:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:24:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:24:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:24:59 INFO - 'XPC_FLAGS': '0x0', 07:24:59 INFO - 'XPC_SERVICE_NAME': '0', 07:24:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:24:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:24:59 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 07:24:59 INFO - Cleaning up... 07:24:59 INFO - Return code: 0 07:24:59 INFO - Running post-action listener: _resource_record_post_action 07:24:59 INFO - Running post-action listener: _start_resource_monitoring 07:24:59 INFO - Starting resource monitoring. 07:24:59 INFO - [mozharness: 2016-08-11 14:24:59.543640Z] Finished create-virtualenv step (success) 07:24:59 INFO - [mozharness: 2016-08-11 14:24:59.544577Z] Running install step. 07:24:59 INFO - Running pre-action listener: _resource_record_pre_action 07:24:59 INFO - Running main action method: install 07:24:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:24:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:24:59 INFO - Reading from file tmpfile_stdout 07:24:59 INFO - Detecting whether we're running mozinstall >=1.0... 07:24:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:24:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:24:59 INFO - Reading from file tmpfile_stdout 07:24:59 INFO - Output received: 07:24:59 INFO - Usage: mozinstall [options] installer 07:24:59 INFO - Options: 07:24:59 INFO - -h, --help show this help message and exit 07:24:59 INFO - -d DEST, --destination=DEST 07:24:59 INFO - Directory to install application into. [default: 07:24:59 INFO - "/builds/slave/test"] 07:24:59 INFO - --app=APP Application being installed. [default: firefox] 07:24:59 INFO - mkdir: /builds/slave/test/build/application 07:24:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 07:24:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 07:25:33 INFO - Reading from file tmpfile_stdout 07:25:33 INFO - Output received: 07:25:33 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 07:25:33 INFO - Running post-action listener: _resource_record_post_action 07:25:33 INFO - [mozharness: 2016-08-11 14:25:33.502367Z] Finished install step (success) 07:25:33 INFO - [mozharness: 2016-08-11 14:25:33.502518Z] Running run-tests step. 07:25:33 INFO - Running pre-action listener: _resource_record_pre_action 07:25:33 INFO - Running main action method: run_tests 07:25:33 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 07:25:33 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 07:25:33 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 07:25:33 INFO - 2016-08-11 07:25:33.517 screenresolution[1718:8176] starting screenresolution argv=screenresolution get 07:25:33 INFO - 2016-08-11 07:25:33.519 screenresolution[1718:8176] Display 0: 1600x1200x32@60 07:25:33 INFO - 2016-08-11 07:25:33.525 screenresolution[1719:8178] starting screenresolution argv=screenresolution list 07:25:33 INFO - Available Modes on Display 0 07:25:33 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 07:25:33 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 07:25:33 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 07:25:33 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 07:25:33 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 07:25:33 INFO - Intel Iris: 07:25:33 INFO - Chipset Model: Intel Iris 07:25:33 INFO - Type: GPU 07:25:33 INFO - Bus: Built-In 07:25:33 INFO - VRAM (Dynamic, Max): 1536 MB 07:25:33 INFO - Vendor: Intel (0x8086) 07:25:33 INFO - Device ID: 0x0a2e 07:25:33 INFO - Revision ID: 0x0009 07:25:33 INFO - Displays: 07:25:33 INFO - Display: 07:25:33 INFO - Resolution: 1600 x 1200 @ 60 Hz 07:25:33 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 07:25:33 INFO - Display Serial Number: 1600x1200 60 07:25:33 INFO - Main Display: Yes 07:25:33 INFO - Mirror: Off 07:25:33 INFO - Online: Yes 07:25:33 INFO - Rotation: Supported 07:25:33 INFO - Return code: 0 07:25:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:25:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:25:33 INFO - Python 2.7.3 07:25:33 INFO - Return code: 0 07:25:33 INFO - grabbing minidump binary from tooltool 07:25:33 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:25:33 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108ac1d30>, '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 0x108826db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108ab9b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:25:33 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 07:25:33 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 07:25:33 INFO - Calling ['/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'] with output_timeout 600 07:25:33 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:25:33 INFO - Return code: 0 07:25:33 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 07:25:33 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:25:33 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:25:33 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 07:25:33 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:25:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0035', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 07:25:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0035 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 07:25:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.all9v01wS1/Render', 07:25:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:25:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:25:33 INFO - 'HOME': '/Users/cltbld', 07:25:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:25:33 INFO - 'LOGNAME': 'cltbld', 07:25:33 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:25:33 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 07:25:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:25:33 INFO - 'MOZ_NO_REMOTE': '1', 07:25:33 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:25:33 INFO - 'NO_EM_RESTART': '1', 07:25:33 INFO - 'PAGER': '/bin/cat', 07:25:33 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:25:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:25:33 INFO - 'PWD': '/builds/slave/test', 07:25:33 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:25:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:25:33 INFO - 'SHELL': '/bin/bash', 07:25:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.Z1RQAvTd8p/Listeners', 07:25:33 INFO - 'TMPDIR': '/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/', 07:25:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:25:33 INFO - 'USER': 'cltbld', 07:25:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:25:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:25:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:25:33 INFO - 'XPC_FLAGS': '0x0', 07:25:33 INFO - 'XPC_SERVICE_NAME': '0', 07:25:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:25:33 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0035', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 07:25:34 INFO - mozversion application_buildid: 20160811041522 07:25:34 INFO - mozversion application_changeset: 39fdb9c2017e96940075926234809cef0f8b5f1b 07:25:34 INFO - mozversion application_display_name: Nightly 07:25:34 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:25:34 INFO - mozversion application_name: Firefox 07:25:34 INFO - mozversion application_remotingname: firefox 07:25:34 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 07:25:34 INFO - mozversion application_vendor: Mozilla 07:25:34 INFO - mozversion application_version: 51.0a1 07:25:34 INFO - mozversion platform_buildid: 20160811041522 07:25:34 INFO - mozversion platform_changeset: 39fdb9c2017e96940075926234809cef0f8b5f1b 07:25:34 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 07:25:34 INFO - mozversion platform_version: 51.0a1 07:25:34 INFO - using testdate: 1470925534 07:25:34 INFO - actual date: 1470925534 07:25:34 INFO - starting webserver on 'localhost:49268' 07:25:34 INFO - SUITE-START | Running 2 tests 07:25:34 INFO - TEST-START | dromaeo_css 07:25:34 INFO - operating with platform_type : mac_ 07:25:34 INFO - Initialising browser for dromaeo_css test... 07:25:34 INFO - TEST-INFO | started process 1729 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/tmpndP9zD/profile http://localhost:49268/getInfo.html) 07:25:37 INFO - PROCESS | 1729 | __metrics Screen width/height:1600/1200 07:25:37 INFO - PROCESS | 1729 | colorDepth:24 07:25:37 INFO - PROCESS | 1729 | Browser inner width/height: 1024/689 07:25:37 INFO - PROCESS | 1729 | __metrics 07:25:37 ERROR - PROCESS | 1729 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 07:25:37 INFO - TEST-INFO | 1729: exit 0 07:25:37 INFO - Browser initialized. 07:25:37 INFO - Running cycle 1/1 for dromaeo_css test... 07:25:37 INFO - TEST-INFO | started process 1734 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/tmpndP9zD/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:25:49 INFO - PROCESS | 1734 | RSS: Main: 254840832 07:25:49 INFO - PROCESS | 1734 | 07:26:39 INFO - PROCESS | 1734 | 1470925599470 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 07:28:51 INFO - PROCESS | 1734 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49268/tests/dromaeo/cssquery-ext.html) 07:28:52 INFO - PROCESS | 1734 | RSS: Main: 267649024 07:28:52 INFO - PROCESS | 1734 | 07:31:54 INFO - PROCESS | 1734 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-ext.html (next: http://localhost:49268/tests/dromaeo/cssquery-jquery.html) 07:31:55 INFO - PROCESS | 1734 | RSS: Main: 276078592 07:31:55 INFO - PROCESS | 1734 | 07:34:57 INFO - PROCESS | 1734 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49268/tests/dromaeo/cssquery-mootools.html) 07:34:57 INFO - PROCESS | 1734 | RSS: Main: 280481792 07:34:57 INFO - PROCESS | 1734 | 07:37:59 INFO - PROCESS | 1734 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49268/tests/dromaeo/cssquery-prototype.html) 07:38:00 INFO - PROCESS | 1734 | RSS: Main: 278888448 07:38:00 INFO - PROCESS | 1734 | 07:41:02 INFO - PROCESS | 1734 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49268/tests/dromaeo/cssquery-yui.html) 07:41:03 INFO - PROCESS | 1734 | RSS: Main: 283467776 07:41:03 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-yui.html (next: http://localhost:49268/tests/dromaeo/cssquery-dojo.html) 07:44:06 INFO - PROCESS | 1734 | RSS: Main: 285057024 07:44:06 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | __start_tp_report 07:44:06 INFO - PROCESS | 1734 | _x_x_mozilla_page_load 07:44:06 INFO - PROCESS | 1734 | _x_x_mozilla_page_load_details 07:44:06 INFO - PROCESS | 1734 | |i|pagename|runs| 07:44:06 INFO - PROCESS | 1734 | |0;dojo.html;2852.557853532703;3279.3246342349153;3284.687954644309;3332.7500437467165;3341.331733653269;4081.979590102049;4552.339910712944;4649.209634362158;4836.581857858455;5610.298712660918;5573.916391254124;5576.804811831586;5576.944230557693;5590.832275031746;5611.186377975191;5052.24216367546;5060.240963855433;5119.078565858144;5175.611829112813;5208.192730126836;5187.351581052369;5195.896082078356;5211.5309622134;5227.686338819683;5228.843134705965;5013.197888337867;5066.46802085783;5094.006668699605;5128.384593848725;5180.274761533388;4999.75001249936;5094.006668699605;5096.974515127437;5113.360829896263;5139.871503212412;4485.551444855521;4816.807327706888;5011.874703132415;5036.370453693288;5074.644774865761;5373.811916582901;5472.1244600864065;5563.36021357545;5607.915881261784;5612;6051.243594550681;6101.237345331833;6106.358832322587;6118.632882027093;6130.509559235251;5378.704171270579;5613.663180209201;5672.773089076432;6039.365866584033;6151.661658608775;5627.887442251132;5659;5667.1782591524;5673.432656734376;5752.626079304831;5201.661891977085;6257.74969001244;6260.092286618415;6265.530085243625;6265.906011409833;5772.624779389326;5989.131575921554;5995.46040856325;6000.369961154103;6025.246844144482;5930.110483427434;6056.909146362808;6120.326764055951;6129.389354848322;6143.84640383994;5991.161237426677;6035.39646035393;6049.122877182784;6065.696715164224;6072.301685306246;6084.026555751058;6102;6132.294786099566;6139.140520327158;6139.631622102688;4733.881652958635;4834.371531700856;4885.145099607555;4906.386701662293;4908.533689299511;4352.194843953878;4375.934360984587;4390.846320378771;4397.934030989538;4422.579854913778;5514.338279406416;5568.582356323292;5577.888442231214;5585;5611.887762244733;5920.141579470953;6100.974805932192;6121.056693972082;6130.356312587114;6196.907046394308;5526.834194974157;5544.140658197985;5555.30558680165;5560.082586373203;5569.554435645138;4703.176944034849;5336.386315573681;5343.064963631349;5359.222912677717;5370.4629537045985;5581.162825576115;5737.655740655574;6132.819519597625;6166.506679465721;6199.287081985539;4930.901381972412;5431.049566325798;6101.974255744823;6143.911070236141;6173.32093469709;6202.7208775606105;6212.285587157535;6216.875662486635;6221.471174949999;6262.060690896402;5885.793997210077;5976.850578735566;6023.789167379121;6048.758049677964;6113.327533971171;6053.636781793107;6074.967255566653;6140.50424869748;6155.630662160284;6156.938430615636;5894.616849904743;5924.674142922181;5934.43622855828;5939.703014849327;5952.642841429528;5688.947544704243;5811.331696854916;5914.526837852875;5928.199693041384;5997.880042399215;5703.600747947604;5707.372189059117;5770.567207459373;5771.94228057714;5862.824115276549;5976.491998180203;5976.850578735566;5989.131575921554;5999.610025348338;6004.369541198112;5619;5719.914201286901;5748.827535173951;5795.275590551181;5840.883182336244 07:44:06 INFO - PROCESS | 1734 | |1;ext.html;492.50995259716586;522.7987224918406;528.7065678548404;534.6551474299077;537.782198209725;38157.80921095398;41368.793156034255;41386.79306603467;41387.58612413879;41534.792326038405;42531.57468425315;42966.92582685434;43010.784946075306;43038.13923721531;43295.78352108243;7696.960910277125;9023.548822558878;9814.46020468874;9814.803703925934;9822.508874556279;9671.177949874269;9783.755406114833;9793.657221997231;9802.117809397152;9832;8898.510581917992;9809.166220871235;9818.9509052455;9867.654632087879;9891.90108098917;9767.951160244189;9797.853032204523;9804;9805.31362804604;9826.754331141707;9697.90302096977;9771.804563908752;9780.951095244549;9805.411675299505;9822.754431139207;32545.51181732276;40339;40348;40490.59509404898;40545.59454405477;2669.292637451077;3242.124626350872;3300.174956260935;3392.525046493493;3516.964830351689;29064;30273.238695326116;30487.932922347834;30562.69437305621;31348.843255783802;3033.074912151793;3040.255137491307;3059.770517211196;3070.6468756093113;3162.7311678507126;446303;446797.7660111711;447405.52594473964;450034;452780.73609632073;34140;34265;34342.90913817768;34381.96854094381;34409.31181376358;34921;35124.82437587796;35221.47167792485;35571.11072223215;36761.81619091887;14524.564263072125;16689.582760431087;16833.747493787603;16847.32610695583;16868.32526698943;12725.745485090247;12791;12816.102872799001;12842.614721558368;12848.550300739429;19110.90444547796;19375.224991000483;19532.316368927302;19552.315668951804;19578.140076692693;8044.678212871419;8090.797730056795;8105.55419451924;8124.350051995826;8205.261526462527;877.5392918717597;946.1484663802632;1066.81330767117;1094.020851338048;1146.9655910322704;25808.870955645103;29383.706162938524;30318.84840575783;30959.0712278632;31250;1051.5373235776235;1060.0141868062622;1068.9251752377415;1083.8320060390652;1095.2608332338648;15785.605359866095;15795.763063554055;15820.129892855774;16058;16310.918445407697;558945;561756;563471;566142;568798;58558;59231.40768592345;59678.40321596815;59734.402655973754;60104.699476503214;1352.5063351876495;1373.4094339433939;1404.810350602676;1406.592088294383;1412.69627030189;27337.863310684115;29020.709792902646;29823.254418639706;30305.393892121592;30486.390272194876;42474.575254248295;52737.20894186514;52970.470295298095;53027.73486132544;53167.20249196188;622826;624188;624831;626866;627483;26670.19989400321;26740.331491712863;27065.72934270711;27089.458210835277;27098;34321.79873704408;37249.627503724616;38879.6112038876;46939.53060469488;46997.76501117473;32091.358172835946;38461.230775384895;39311.41032884452;40186.39720404138;40318.39522407108;33064.18147001938;38328.80835595804;38492.80753596214;38666.6133338663;39825;32708;36241.27517449689;39898.800505997286;39902.800485998545;40699.59300407077;31990.840045800553;34796.82601586976;35004.91642084607;35500.822495887354;35661.64338356583;21792.128314867863;26127;26455.867720661274;26475.60286595664;26548.469030619664 07:44:06 INFO - PROCESS | 1734 | |2;jquery.html;335.2339903320912;378.77462909568817;384.3024909788732;387.6317498376543;404.6742372390225;16321.183940802957;20015;20786.584268314626;21191.470213244676;21392.57214855702;16505.504834854943;21118.944052797375;21206;21357.786422135774;21583.892080539576;5791.507721843648;5844.853878653036;5988;6079;6085.878282434349;5951.58338916276;5992.7902523411685;6050.909236361458;6061.333253342129;6069.635821850681;5191.792328306863;5709.942900570983;5863.5309175265875;5923.940760592403;6009.879802403972;5914.3494215636465;5922.082077278029;5930.080837470199;5930.347661757203;5975.581709280352;4989.800407983713;5075.593952483792;5142.3829140503;5145.30538377318;5162.586993040548;26023.349416264744;26087.73912260872;26187.952481900702;26202.86898565514;26262.343441413926;2405.20628192696;2470.3206618179966;3059.29636183679;3070.355225402668;3187.235063584746;15531.611709707235;15925.283362248727;16021.35914563416;16162.919185403998;16236.350545978265;1693.9243580326581;1730.9181761399125;1813.727940808876;1843.797182309945;1978.2482656590548;95514.13457596283;114247;117940;118253;119348.8065119355;9896.950515247378;10307.690769276935;10508.42203678805;10811.567537298577;10855.402952837512;13520;13625.795613065811;13668.453261869414;13680.247586382646;13714.17714937087;8312.376571757022;8474.152584741476;8561.571921403905;8695.521746304014;8730.995935467376;7092.574445533284;8701.782455438664;8724.214820666171;8880.73357799267;8893.866592001124;5606.719664016783;5961.807638472236;6485.337908949928;6549.967250163814;6801.4558835293055;1758.5251981965055;1833.5049536625304;1881.303917550515;1883.1808163448943;1883.256113835055;724.2540183610889;808.2685169921231;819.4264015189391;952.8189643967625;969;17499.68752343554;20693.379198624065;21174.576508469745;22588.887055564945;22594.435139121655;892.9687460938836;925.9305552083621;937.4703292639637;957.4973139101888;981.4503877828439;9845.950770246103;11249.481320021856;11864.288142711464;11990.940045299718;12012.579559715368;502303;584356;590784;605422;617555;89014;121099.5780084411;125121;125706;126580.1012984806;903.7243640689653;957.2963871554402;960.6397600899662;965.2229954886244;966.9468179250068;18970.52573685669;19266;19371.61256774885;19398.806011940265;19401;54829;55278;56169.43830561805;56930;57028.28915132552;63635;82012.58993705233;83128.16871831204;84271;84508.57745711478;7826.686932522635;7924.286814186751;8201.671933122847;8207.384446166441;8355.83288334242;9122.452652840851;12408.193467424588;13020.869791302344;13090;13608.319584020957;10666.520006599567;10735.355878647306;11272.605458808903;11577.6526704199;11651;8733.606987685696;11127.387993660426;11385.089192864716;11572.710682233012;11666.824997624874;11119.444027798416;11631.709207269885;11873.050155987328;11890.940545297564;11964.940175299067;6811.69347379379;8137.511749295061;8328.375371847256;8412.116727743498;8441.746747597583;9618.855717164388;11564.768704626029;11581.88418115808;11606.24559403636;11656.067514598642 07:44:06 INFO - PROCESS | 1734 | |3;mootools.html;1532.2874863188615;1547.9845201547985;1764;1852.7220916862461;1874.9718754218682;7908.446408751375;8354.582270886454;8571;8836.513991730451;8884.911150888498;8570.142985701426;8773.60518776655;8774.034856165817;8774.078721734222;8790.34072444566;2298.9540209195807;2349.3539276698875;2350.4476448034698;2354.7409784923643;2354.882255887199;1952.3069310394746;2339.894704738282;2356.646503024543;2357.281029286067;2360.834741568091;2327.3832434404894;2331.6619090231907;2342.8945697443655;2344.9296521104393;2356.6936298281285;2307.9636170350013;2320.5358928214423;2333.9066437342485;2335.719713634358;2342;2311.734150572672;2319.686842276288;2329.149860300995;2330.5222429401933;2330.9184178553837;7745.535267883945;8701.042885282613;8727;8761.693340733107;8817.030126686059;4360.345948107777;5207.817726379559;5292.655977361498;5293.7617807198385;5336.706481143536;3357.2278375973665;3392.8982130536124;3462.342154990569;3493.493443450711;3546.6453354664586;1001.5042553935848;1046.638909576195;1058.5501162006194;1069.6309773128337;1075;11621.360825154614;11624.825627615592;11698.590549330818;11702.53189872404;11708.765824683544;4525.456945166601;4565.429321334833;4726.361941137971;4730.881727956828;4758.42898852133;9852.014798520235;9938.602455901682;9979.750506237402;9980.550875210633;10018.048285412875;5341.786328546892;5342.893142137135;5345.919811202835;5357.4106848246665;5363.758630861621;4352.151330490524;4680.485146633868;4822.758862056883;4855.732934688626;4907.993861258434;3054.6639869614323;3860.82626281818;3924.9803750981064;3970.3647416413237;4028.8589899353383;1282.6216266201493;1296.8703129686955;1299.4802079168408;1306.405585458614;1307.4181989014796;901.4951627088851;917.3945196170496;921.4379228670506;952.0051546134306;962.3167551038841;5774.105013722879;5925.970370148121;5992.460678538952;6100.115483254903;6119.418655227746;380.7353889047141;434.60450989599315;443.72267332916925;450.5246964452534;451.34329550504594;3905.1799122184093;3907.8632247871187;4018.799060046986;4023.657989070903;4033.9193216135513;10398.792024159475;10765.623203187852;10806.459677016117;10812.72968175786;10813.134949204203;10721.83917241242;10751.569937202425;10790.028897399272;10797.514111864828;10821.134309255242;6797.796066118024;8024.037115546055;8091.745779404202;8227.794305142419;8247.95876020616;5761.337446193574;5832.387599302012;5850.356460789395;5864.648121112747;5869.35437101927;9888.060634239735;9957.352772069793;9975.60097596088;9997.900020999989;10074.8488772667;9898.257630677585;10162.89837101649;10231.823340315661;10311.175105991353;10326;6919.377256046779;7393.852122957618;7522.059742532184;7545.056867891513;7608.505447145918;8258.793530161794;8289.544075075928;8304.335653147855;8317.792055198668;8324;7387.4090072795125;7503.66233519482;7515.473916825988;7563.432742544222;7630.961845190738;7251.891221631574;7317.817054573678;7351.228121047213;7443.962780186064;7473.6263186841525;6864.347886950732;7004.964975175295;7031.542949708252;7033.859322813618;7034.753783617549;4793.448753393404;4948.257761335828;4978.751062446936;4992.900141997067;5096.388433388017;4829.010052939209;4937.456879743298;5029.59763218949;5129.076766182123;5166.173412254172 07:44:06 INFO - PROCESS | 1734 | |4;prototype.html;272.8076705922325;306.08175473579263;309.81565968248884;311.5451440896291;314.86932922837025;4563.863084107474;4694.8262934266395;5319.707416092114;5415.83752487425;5567.276254086968;4718.480967093626;5473.370562385327;5509.752061157247;5512.9173062404;5524.640898341605;3501.9863578442496;3531.611522732497;3919.0006548330134;4238.321868501041;4261.552536983619;3500.3524347995576;3653.3058718843467;4109.301418758803;4253.340732186516;4280.614744672979;3277.754168437365;4039.131586708857;4070.857519986801;4084.060666046811;4095.4266402703647;3578.320119177374;4091.488563929509;4097.405876147972;4118.382242663594;4140.37894315852;3470.1151206442446;3573;3588.0132963435003;3600.71194304455;3626.3110009098186;4468.7710879508395;4906.632002599784;4956.628252881048;5211.7394130293715;5467.097928841737;4306.870793876189;4346.9132716820795;4433.290673492258;4495.865124046284;4674.883127921795;5728.369879313273;5736.2256095427;5749.338826034976;5754.367019627837;5803.968610986163;3069.478188707925;3758.590528551793;3803.315403227418;3877.418387241908;3920.7255492115564;4966.255061740731;5967.403259674042;6101.169649105295;6122.204113465265;6187.226596675416;3301.092199645117;3646.6171052039153;3928.958825911136;3955.940660890089;3962.5046869141356;3709.573399059089;3869.10413897194;3969.226000929791;4007.198560287954;4021.4369988201674;4072.063425412172;4073.06319546506;4274.978625106854;4594.65540084495;4692.835750748775;4650.465196502378;5721.113227449752;5786.363500014995;5823.301203855564;5825.912611310834;1253.6239128261484;1260.9345103387623;1275.145652412867;1322.0415198980854;1352.939117739704;749.336836899348;909.7407238937003;916.6333466613409;918.2011649864661;921.2123634292717;4213.578642135762;4571.885702857388;5210.947890521122;5211.921821172609;5215.634905556651;5750.741216645261;5751.166080918327;5760.279965004374;5785.421457854265;5786.479216870502;4781.641376896747;4867.805287788519;4954.950450495521;5105.821296254688;5213.322268105122;2251.1203145373797;2413.3483959331234;2487.8756062196817;2640.5115053715126;2644.3256969472664;4522.683412161183;4861.732604706775;5064.392272927199;5101.362329708786;5116.083832215601;3878.728489005799;4127.484064491939;4513.232750432434;4930.964497455503;5145.768440420115;4186.8341000704495;4652.790624421977;5133.666311689728;5178.368813823634;5245.659032162897;4414.514403415557;4543.3639290498695;4603.079384123122;4932.876678082933;5101.729730269994;4220.66234701217;4493.505714371351;4909.877253068702;4963.255511673278;5000.699818047407;4180.088396134591;4566.70316429431;4685.922237885237;5105.642605017613;5133.948660513347;2921.8962347110046;2944.455275773989;3013.3370658455983;3474.3398754236614;3481.199324155509;4022.416749571354;4654.394928659252;5024.723640199678;5169.4830516948;5639.464250896158;4525.502194758508;5711.800086997101;5748.109043098327;5755.453231942959;5839.708014599168;5765.731539061399;5776.971115144397;5780.739866705924;5798.927198468297;5817.283901249226;5232;5611.915821262603;5648.943510564842;5682.772689092555;5691.60555663865;5835.8832823342445;5866.829273168954;5912.526997840077;5918.408159184047;5939.613925094855;4345.000649850615;5773.797917072882;5839;5858.853528661647;5907.202527658883 07:44:06 INFO - PROCESS | 1734 | |5;yui.html;693.7883945396652;765.7779244019234;766.904136982877;794.9721759738403;876.618670878168;15299.694006119886;15948.521544353658;15957.920210398946;15966.84033159668;15975.201239937986;14084.929575352135;14357;14489.347979340955;14499.20254386011;14540.781888271684;751.6993202718902;839.6809212499242;888.6356593796545;899.6626265150569;904.8552231642939;845.5096044294326;870.1776820904248;884.7876509637673;894.5259012723235;898.3846065445191;902.440486898124;932.8600709893502;937.653068364706;939.2392162348519;939.9859002114973;920.1442658327786;926.990730092704;928.0951072704094;928.9489078100769;929.1591110045385;589.6609449566473;681.7852376501386;694.5763084518439;694.8957656351537;701.1060897355861;15264.694706105927;15587.298571564306;15590.454334098253;15625.3749850007;15632.921835390864;14123.435062597484;14126.152430854181;14276.57170284893;14285.357158927769;14497;11786.646400607995;11806.40967951599;11931.40342982856;12025.278483290944;12186.207896486789;3767.660910518039;3797.9240415191816;3807.428885667144;3835.5972622874756;3891.377379619247;106554.46722766414;108281;117717.41141294324;118146.22780658297;119584;10367.896321036844;10424.414084744216;10565.9471702641;10622.20333474977;10829.512671929782;21959.231426899983;22261.3321600349;22452;22496.437589060406;22523.099076036775;7866.213378662088;8000;8013.8397232056195;8024.799380015546;8065.39509536787;3767.3407153747985;4562.292844609091;4566.520515345907;4572.474165470947;4730.030343779517;3173.793958295879;3648.069742215718;3760.4923335349927;3764.284785890672;3773.2264885698364;574.371063685264;598.6557729305666;615.2432508015166;624.7879114517912;628.7107930351998;507.7106049551794;665.1685393258427;690.6926417744156;700.9205823032574;708.9645517724093;9132.589033493508;9559.761005974768;9739.26955478342;9769.462679552551;9819.75450613726;597.8893904627657;613.2640831002815;625.7465726380823;625.8591816841265;628.3496581038603;4487.855596822789;4601.056783359403;4674.719516829001;4678.649101317346;4700.271457924027;136819.31590341983;149969;150291.49708502993;152842.8862845496;155958.66062009078;121475.39262303631;121691;127962;131670;133177;96038.51980740052;102629;106372.68136593293;108793;108841;7084.752033678797;8654.264387527131;9087.954560227421;9236.769080772765;9349.345545812;53234.13680521163;60117.69941150266;62205.68897155485;63233.10300690986;64693.67653161704;79190.6040469794;90553.92159310485;100343.31432665577;101177.97644046931;101264;11580.710482238012;11685.649430517098;11784.410779461165;12070.336131512851;12429.813552796897;10523.631672891412;10923.508442119964;13007.674808129872;13470.124441911245;13688;10244.897551024394;10922.344659320466;12752.043596730096;12858.935705321413;12889.226646401246;11891.464884080064;12231.143819932518;12348.506059757508;12689.111762176928;12729.681757956125;10433.791324173322;11890.881091188978;12596.055295852664;12630;12654.177478463871;7039.507234493536;9115.635374584943;9261.120193581599;9350.525830852548;9989.950050249703;8090.775036864909;8894.155055269739;8992.370534062553;9478.763030924281;9709.36889102206 07:44:06 INFO - PROCESS | 1734 | __end_tp_report 07:44:06 INFO - PROCESS | 1734 | __start_cc_report 07:44:06 INFO - PROCESS | 1734 | _x_x_mozilla_cycle_collect,412 07:44:06 INFO - PROCESS | 1734 | __end_cc_report 07:44:06 INFO - PROCESS | 1734 | __startTimestamp1470926646423__endTimestamp 07:44:06 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | ------- Summary: start ------- 07:44:06 INFO - PROCESS | 1734 | Number of tests: 6 07:44:06 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | [#0] dojo.html Cycles:165 Average:5555.08 Median:5688.95 stddev:650.53 (11.4%) stddev-sans-first:617.02 07:44:06 INFO - PROCESS | 1734 | Values: 2852.6 3279.3 3284.7 3332.8 3341.3 4082.0 4552.3 4649.2 4836.6 5610.3 5573.9 5576.8 5576.9 5590.8 5611.2 5052.2 5060.2 5119.1 5175.6 5208.2 5187.4 5195.9 5211.5 5227.7 5228.8 5013.2 5066.5 5094.0 5128.4 5180.3 4999.8 5094.0 5097.0 5113.4 5139.9 4485.6 4816.8 5011.9 5036.4 5074.6 5373.8 5472.1 5563.4 5607.9 5612.0 6051.2 6101.2 6106.4 6118.6 6130.5 5378.7 5613.7 5672.8 6039.4 6151.7 5627.9 5659.0 5667.2 5673.4 5752.6 5201.7 6257.7 6260.1 6265.5 6265.9 5772.6 5989.1 5995.5 6000.4 6025.2 5930.1 6056.9 6120.3 6129.4 6143.8 5991.2 6035.4 6049.1 6065.7 6072.3 6084.0 6102.0 6132.3 6139.1 6139.6 4733.9 4834.4 4885.1 4906.4 4908.5 4352.2 4375.9 4390.8 4397.9 4422.6 5514.3 5568.6 5577.9 5585.0 5611.9 5920.1 6101.0 6121.1 6130.4 6196.9 5526.8 5544.1 5555.3 5560.1 5569.6 4703.2 5336.4 5343.1 5359.2 5370.5 5581.2 5737.7 6132.8 6166.5 6199.3 4930.9 5431.0 6102.0 6143.9 6173.3 6202.7 6212.3 6216.9 6221.5 6262.1 5885.8 5976.9 6023.8 6048.8 6113.3 6053.6 6075.0 6140.5 6155.6 6156.9 5894.6 5924.7 5934.4 5939.7 5952.6 5688.9 5811.3 5914.5 5928.2 5997.9 5703.6 5707.4 5770.6 5771.9 5862.8 5976.5 5976.9 5989.1 5999.6 6004.4 5619.0 5719.9 5748.8 5795.3 5840.9 07:44:06 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | [#1] ext.html Cycles:180 Average:66735.98 Median:38243.31 stddev:147256.56 (385.1%) stddev-sans-first:147585.66 07:44:06 INFO - PROCESS | 1734 | Values: 492.5 522.8 528.7 534.7 537.8 38157.8 41368.8 41386.8 41387.6 41534.8 42531.6 42966.9 43010.8 43038.1 43295.8 7697.0 9023.5 9814.5 9814.8 9822.5 9671.2 9783.8 9793.7 9802.1 9832.0 8898.5 9809.2 9819.0 9867.7 9891.9 9768.0 9797.9 9804.0 9805.3 9826.8 9697.9 9771.8 9781.0 9805.4 9822.8 32545.5 40339.0 40348.0 40490.6 40545.6 2669.3 3242.1 3300.2 3392.5 3517.0 29064.0 30273.2 30487.9 30562.7 31348.8 3033.1 3040.3 3059.8 3070.6 3162.7 446303.0 446797.8 447405.5 450034.0 452780.7 34140.0 34265.0 34342.9 34382.0 34409.3 34921.0 35124.8 35221.5 35571.1 36761.8 14524.6 16689.6 16833.7 16847.3 16868.3 12725.7 12791.0 12816.1 12842.6 12848.6 19110.9 19375.2 19532.3 19552.3 19578.1 8044.7 8090.8 8105.6 8124.4 8205.3 877.5 946.1 1066.8 1094.0 1147.0 25808.9 29383.7 30318.8 30959.1 31250.0 1051.5 1060.0 1068.9 1083.8 1095.3 15785.6 15795.8 15820.1 16058.0 16310.9 558945.0 561756.0 563471.0 566142.0 568798.0 58558.0 59231.4 59678.4 59734.4 60104.7 1352.5 1373.4 1404.8 1406.6 1412.7 27337.9 29020.7 29823.3 30305.4 30486.4 42474.6 52737.2 52970.5 53027.7 53167.2 622826.0 624188.0 624831.0 626866.0 627483.0 26670.2 26740.3 27065.7 27089.5 27098.0 34321.8 37249.6 38879.6 46939.5 46997.8 32091.4 38461.2 39311.4 40186.4 40318.4 33064.2 38328.8 38492.8 38666.6 39825.0 32708.0 36241.3 39898.8 39902.8 40699.6 31990.8 34796.8 35004.9 35500.8 35661.6 21792.1 26127.0 26455.9 26475.6 26548.5 07:44:06 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | [#2] jquery.html Cycles:180 Average:34426.90 Median:385.97 stddev:96884.00 (25101.6%) stddev-sans-first:97121.97 07:44:06 INFO - PROCESS | 1734 | Values: 335.2 378.8 384.3 387.6 404.7 16321.2 20015.0 20786.6 21191.5 21392.6 16505.5 21118.9 21206.0 21357.8 21583.9 5791.5 5844.9 5988.0 6079.0 6085.9 5951.6 5992.8 6050.9 6061.3 6069.6 5191.8 5709.9 5863.5 5923.9 6009.9 5914.3 5922.1 5930.1 5930.3 5975.6 4989.8 5075.6 5142.4 5145.3 5162.6 26023.3 26087.7 26188.0 26202.9 26262.3 2405.2 2470.3 3059.3 3070.4 3187.2 15531.6 15925.3 16021.4 16162.9 16236.4 1693.9 1730.9 1813.7 1843.8 1978.2 95514.1 114247.0 117940.0 118253.0 119348.8 9897.0 10307.7 10508.4 10811.6 10855.4 13520.0 13625.8 13668.5 13680.2 13714.2 8312.4 8474.2 8561.6 8695.5 8731.0 7092.6 8701.8 8724.2 8880.7 8893.9 5606.7 5961.8 6485.3 6550.0 6801.5 1758.5 1833.5 1881.3 1883.2 1883.3 724.3 808.3 819.4 952.8 969.0 17499.7 20693.4 21174.6 22588.9 22594.4 893.0 925.9 937.5 957.5 981.5 9846.0 11249.5 11864.3 11990.9 12012.6 502303.0 584356.0 590784.0 605422.0 617555.0 89014.0 121099.6 125121.0 125706.0 126580.1 903.7 957.3 960.6 965.2 966.9 18970.5 19266.0 19371.6 19398.8 19401.0 54829.0 55278.0 56169.4 56930.0 57028.3 63635.0 82012.6 83128.2 84271.0 84508.6 7826.7 7924.3 8201.7 8207.4 8355.8 9122.5 12408.2 13020.9 13090.0 13608.3 10666.5 10735.4 11272.6 11577.7 11651.0 8733.6 11127.4 11385.1 11572.7 11666.8 11119.4 11631.7 11873.1 11890.9 11964.9 6811.7 8137.5 8328.4 8412.1 8441.7 9618.9 11564.8 11581.9 11606.2 11656.1 07:44:06 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | [#3] mootools.html Cycles:180 Average:5677.85 Median:4825.88 stddev:3221.36 (66.8%) stddev-sans-first:3215.33 07:44:06 INFO - PROCESS | 1734 | Values: 1532.3 1548.0 1764.0 1852.7 1875.0 7908.4 8354.6 8571.0 8836.5 8884.9 8570.1 8773.6 8774.0 8774.1 8790.3 2299.0 2349.4 2350.4 2354.7 2354.9 1952.3 2339.9 2356.6 2357.3 2360.8 2327.4 2331.7 2342.9 2344.9 2356.7 2308.0 2320.5 2333.9 2335.7 2342.0 2311.7 2319.7 2329.1 2330.5 2330.9 7745.5 8701.0 8727.0 8761.7 8817.0 4360.3 5207.8 5292.7 5293.8 5336.7 3357.2 3392.9 3462.3 3493.5 3546.6 1001.5 1046.6 1058.6 1069.6 1075.0 11621.4 11624.8 11698.6 11702.5 11708.8 4525.5 4565.4 4726.4 4730.9 4758.4 9852.0 9938.6 9979.8 9980.6 10018.0 5341.8 5342.9 5345.9 5357.4 5363.8 4352.2 4680.5 4822.8 4855.7 4908.0 3054.7 3860.8 3925.0 3970.4 4028.9 1282.6 1296.9 1299.5 1306.4 1307.4 901.5 917.4 921.4 952.0 962.3 5774.1 5926.0 5992.5 6100.1 6119.4 380.7 434.6 443.7 450.5 451.3 3905.2 3907.9 4018.8 4023.7 4033.9 10398.8 10765.6 10806.5 10812.7 10813.1 10721.8 10751.6 10790.0 10797.5 10821.1 6797.8 8024.0 8091.7 8227.8 8248.0 5761.3 5832.4 5850.4 5864.6 5869.4 9888.1 9957.4 9975.6 9997.9 10074.8 9898.3 10162.9 10231.8 10311.2 10326.0 6919.4 7393.9 7522.1 7545.1 7608.5 8258.8 8289.5 8304.3 8317.8 8324.0 7387.4 7503.7 7515.5 7563.4 7631.0 7251.9 7317.8 7351.2 7444.0 7473.6 6864.3 7005.0 7031.5 7033.9 7034.8 4793.4 4948.3 4978.8 4992.9 5096.4 4829.0 4937.5 5029.6 5129.1 5166.2 07:44:06 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | [#4] prototype.html Cycles:180 Average:4378.68 Median:4680.40 stddev:1386.05 (29.6%) stddev-sans-first:1355.24 07:44:06 INFO - PROCESS | 1734 | Values: 272.8 306.1 309.8 311.5 314.9 4563.9 4694.8 5319.7 5415.8 5567.3 4718.5 5473.4 5509.8 5512.9 5524.6 3502.0 3531.6 3919.0 4238.3 4261.6 3500.4 3653.3 4109.3 4253.3 4280.6 3277.8 4039.1 4070.9 4084.1 4095.4 3578.3 4091.5 4097.4 4118.4 4140.4 3470.1 3573.0 3588.0 3600.7 3626.3 4468.8 4906.6 4956.6 5211.7 5467.1 4306.9 4346.9 4433.3 4495.9 4674.9 5728.4 5736.2 5749.3 5754.4 5804.0 3069.5 3758.6 3803.3 3877.4 3920.7 4966.3 5967.4 6101.2 6122.2 6187.2 3301.1 3646.6 3929.0 3955.9 3962.5 3709.6 3869.1 3969.2 4007.2 4021.4 4072.1 4073.1 4275.0 4594.7 4692.8 4650.5 5721.1 5786.4 5823.3 5825.9 1253.6 1260.9 1275.1 1322.0 1352.9 749.3 909.7 916.6 918.2 921.2 4213.6 4571.9 5210.9 5211.9 5215.6 5750.7 5751.2 5760.3 5785.4 5786.5 4781.6 4867.8 4955.0 5105.8 5213.3 2251.1 2413.3 2487.9 2640.5 2644.3 4522.7 4861.7 5064.4 5101.4 5116.1 3878.7 4127.5 4513.2 4931.0 5145.8 4186.8 4652.8 5133.7 5178.4 5245.7 4414.5 4543.4 4603.1 4932.9 5101.7 4220.7 4493.5 4909.9 4963.3 5000.7 4180.1 4566.7 4685.9 5105.6 5133.9 2921.9 2944.5 3013.3 3474.3 3481.2 4022.4 4654.4 5024.7 5169.5 5639.5 4525.5 5711.8 5748.1 5755.5 5839.7 5765.7 5777.0 5780.7 5798.9 5817.3 5232.0 5611.9 5648.9 5682.8 5691.6 5835.9 5866.8 5912.5 5918.4 5939.6 4345.0 5773.8 5839.0 5858.9 5907.2 07:44:06 INFO - PROCESS | 1734 | 07:44:06 INFO - PROCESS | 1734 | [#5] yui.html Cycles:180 Average:24536.88 Median:3821.51 stddev:39686.35 (1038.5%) stddev-sans-first:39757.30 07:44:06 INFO - PROCESS | 1734 | Values: 693.8 765.8 766.9 795.0 876.6 15299.7 15948.5 15957.9 15966.8 15975.2 14084.9 14357.0 14489.3 14499.2 14540.8 751.7 839.7 888.6 899.7 904.9 845.5 870.2 884.8 894.5 898.4 902.4 932.9 937.7 939.2 940.0 920.1 927.0 928.1 928.9 929.2 589.7 681.8 694.6 694.9 701.1 15264.7 15587.3 15590.5 15625.4 15632.9 14123.4 14126.2 14276.6 14285.4 14497.0 11786.6 11806.4 11931.4 12025.3 12186.2 3767.7 3797.9 3807.4 3835.6 3891.4 106554.5 108281.0 117717.4 118146.2 119584.0 10367.9 10424.4 10565.9 10622.2 10829.5 21959.2 22261.3 22452.0 22496.4 22523.1 7866.2 8000.0 8013.8 8024.8 8065.4 3767.3 4562.3 4566.5 4572.5 4730.0 3173.8 3648.1 3760.5 3764.3 3773.2 574.4 598.7 615.2 624.8 628.7 507.7 665.2 690.7 700.9 709.0 9132.6 9559.8 9739.3 9769.5 9819.8 597.9 613.3 625.7 625.9 628.3 4487.9 4601.1 4674.7 4678.6 4700.3 136819.3 149969.0 150291.5 152842.9 155958.7 121475.4 121691.0 127962.0 131670.0 133177.0 96038.5 102629.0 106372.7 108793.0 108841.0 7084.8 8654.3 9088.0 9236.8 9349.3 53234.1 60117.7 62205.7 63233.1 64693.7 79190.6 90553.9 100343.3 101178.0 101264.0 11580.7 11685.6 11784.4 12070.3 12429.8 10523.6 10923.5 13007.7 13470.1 13688.0 10244.9 10922.3 12752.0 12858.9 12889.2 11891.5 12231.1 12348.5 12689.1 12729.7 10433.8 11890.9 12596.1 12630.0 12654.2 7039.5 9115.6 9261.1 9350.5 9990.0 8090.8 8894.2 8992.4 9478.8 9709.4 07:44:06 INFO - PROCESS | 1734 | -------- Summary: end -------- 07:44:06 INFO - PROCESS | 1734 | 07:44:07 INFO - TEST-INFO | 1734: exit 0 07:44:07 INFO - TEST-OK | dromaeo_css | took 1113019ms 07:44:07 INFO - TEST-START | kraken 07:44:07 INFO - operating with platform_type : mac_ 07:44:07 INFO - Initialising browser for kraken test... 07:44:07 INFO - TEST-INFO | started process 1852 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/tmpCDdGOr/profile http://localhost:49268/getInfo.html) 07:44:09 INFO - PROCESS | 1852 | __metrics Screen width/height:1600/1200 07:44:09 INFO - PROCESS | 1852 | colorDepth:24 07:44:09 INFO - PROCESS | 1852 | Browser inner width/height: 1024/689 07:44:09 INFO - PROCESS | 1852 | __metrics 07:44:09 ERROR - PROCESS | 1852 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 07:44:10 INFO - TEST-INFO | 1852: exit 0 07:44:10 INFO - Browser initialized. 07:44:10 INFO - Running cycle 1/1 for kraken test... 07:44:10 INFO - TEST-INFO | started process 1855 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/tmpCDdGOr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:44:22 INFO - PROCESS | 1855 | RSS: Main: 254599168 07:44:22 INFO - PROCESS | 1855 | 07:44:25 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-beat-detection) 07:44:26 INFO - PROCESS | 1855 | RSS: Main: 267329536 07:44:26 INFO - PROCESS | 1855 | 07:44:29 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-dft) 07:44:29 INFO - PROCESS | 1855 | RSS: Main: 275980288 07:44:29 INFO - PROCESS | 1855 | 07:44:33 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-fft) 07:44:33 INFO - PROCESS | 1855 | RSS: Main: 279089152 07:44:33 INFO - PROCESS | 1855 | 07:44:35 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-oscillator) 07:44:36 INFO - PROCESS | 1855 | RSS: Main: 281391104 07:44:36 INFO - PROCESS | 1855 | 07:44:38 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:44:38 INFO - PROCESS | 1855 | RSS: Main: 282079232 07:44:38 INFO - PROCESS | 1855 | 07:44:41 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-darkroom) 07:44:42 INFO - PROCESS | 1855 | RSS: Main: 282148864 07:44:42 INFO - PROCESS | 1855 | 07:44:45 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-desaturate) 07:44:46 INFO - PROCESS | 1855 | RSS: Main: 281845760 07:44:46 INFO - PROCESS | 1855 | 07:44:49 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49268/tests/kraken/driver.html?testName=json-parse-financial) 07:44:49 INFO - PROCESS | 1855 | RSS: Main: 282771456 07:44:49 INFO - PROCESS | 1855 | 07:44:51 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49268/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:44:52 INFO - PROCESS | 1855 | RSS: Main: 282234880 07:44:52 INFO - PROCESS | 1855 | 07:44:54 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:44:54 INFO - PROCESS | 1855 | RSS: Main: 282284032 07:44:54 INFO - PROCESS | 1855 | 07:44:57 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:44:57 INFO - PROCESS | 1855 | RSS: Main: 282353664 07:44:57 INFO - PROCESS | 1855 | 07:45:00 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:45:01 INFO - PROCESS | 1855 | RSS: Main: 282578944 07:45:01 INFO - PROCESS | 1855 | 07:45:04 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:45:04 INFO - PROCESS | 1855 | RSS: Main: 282427392 07:45:04 INFO - PROCESS | 1855 | 07:45:06 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49268/tests/kraken/driver.html?testName=ai-astar) 07:45:07 INFO - PROCESS | 1855 | RSS: Main: 283279360 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | __start_tp_report 07:45:07 INFO - PROCESS | 1855 | _x_x_mozilla_page_load 07:45:07 INFO - PROCESS | 1855 | _x_x_mozilla_page_load_details 07:45:07 INFO - PROCESS | 1855 | |i|pagename|runs| 07:45:07 INFO - PROCESS | 1855 | |0;ai-astar;105;117;108;120;117;117;115;117;118;118 07:45:07 INFO - PROCESS | 1855 | |1;audio-beat-detection;145;123;167;189;112;134;117;138;183;110 07:45:07 INFO - PROCESS | 1855 | |2;audio-dft;207;238;212;283;241;200;202;198;201;192 07:45:07 INFO - PROCESS | 1855 | |3;audio-fft;72;86;74;143;59;59;59;62;135;58 07:45:07 INFO - PROCESS | 1855 | |4;audio-oscillator;70;71;124;70;72;85;116;70;73;143 07:45:07 INFO - PROCESS | 1855 | |5;imaging-gaussian-blur;90;82;89;86;90;87;89;87;89;89 07:45:07 INFO - PROCESS | 1855 | |6;imaging-darkroom;96;104;94;123;107;106;156;155;102;95 07:45:07 INFO - PROCESS | 1855 | |7;imaging-desaturate;150;111;126;129;89;73;134;145;140;94 07:45:07 INFO - PROCESS | 1855 | |8;json-parse-financial;46;47;86;86;89;56;56;56;56;55 07:45:07 INFO - PROCESS | 1855 | |9;json-stringify-tinderbox;68;75;73;87;76;88;119;90;75;76 07:45:07 INFO - PROCESS | 1855 | |10;stanford-crypto-aes;86;86;90;86;87;90;115;76;103;77 07:45:07 INFO - PROCESS | 1855 | |11;stanford-crypto-ccm;135;167;151;148;174;147;140;157;167;146 07:45:07 INFO - PROCESS | 1855 | |12;stanford-crypto-pbkdf2;166;168;166;167;167;166;168;175;168;168 07:45:07 INFO - PROCESS | 1855 | |13;stanford-crypto-sha256-iterative;70;81;85;85;92;75;70;69;88;89 07:45:07 INFO - PROCESS | 1855 | __end_tp_report 07:45:07 INFO - PROCESS | 1855 | __start_cc_report 07:45:07 INFO - PROCESS | 1855 | _x_x_mozilla_cycle_collect,1060 07:45:07 INFO - PROCESS | 1855 | __end_cc_report 07:45:07 INFO - PROCESS | 1855 | __startTimestamp1470926707020__endTimestamp 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | ------- Summary: start ------- 07:45:07 INFO - PROCESS | 1855 | Number of tests: 14 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#0] ai-astar Cycles:10 Average:115.20 Median:117.00 stddev:4.80 (4.1%) stddev-sans-first:3.39 07:45:07 INFO - PROCESS | 1855 | Values: 105.0 117.0 108.0 120.0 117.0 117.0 115.0 117.0 118.0 118.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#1] audio-beat-detection Cycles:10 Average:141.80 Median:141.50 stddev:28.89 (20.4%) stddev-sans-first:30.62 07:45:07 INFO - PROCESS | 1855 | Values: 145.0 123.0 167.0 189.0 112.0 134.0 117.0 138.0 183.0 110.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#2] audio-dft Cycles:10 Average:217.40 Median:209.50 stddev:28.39 (13.5%) stddev-sans-first:29.86 07:45:07 INFO - PROCESS | 1855 | Values: 207.0 238.0 212.0 283.0 241.0 200.0 202.0 198.0 201.0 192.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#3] audio-fft Cycles:10 Average:80.70 Median:60.50 stddev:32.07 (53.0%) stddev-sans-first:33.86 07:45:07 INFO - PROCESS | 1855 | Values: 72.0 86.0 74.0 143.0 59.0 59.0 59.0 62.0 135.0 58.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#4] audio-oscillator Cycles:10 Average:89.40 Median:70.50 stddev:27.56 (39.1%) stddev-sans-first:28.32 07:45:07 INFO - PROCESS | 1855 | Values: 70.0 71.0 124.0 70.0 72.0 85.0 116.0 70.0 73.0 143.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#5] imaging-gaussian-blur Cycles:10 Average:87.80 Median:89.00 stddev:2.44 (2.7%) stddev-sans-first:2.46 07:45:07 INFO - PROCESS | 1855 | Values: 90.0 82.0 89.0 86.0 90.0 87.0 89.0 87.0 89.0 89.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#6] imaging-darkroom Cycles:10 Average:113.80 Median:155.50 stddev:23.49 (15.1%) stddev-sans-first:24.02 07:45:07 INFO - PROCESS | 1855 | Values: 96.0 104.0 94.0 123.0 107.0 106.0 156.0 155.0 102.0 95.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#7] imaging-desaturate Cycles:10 Average:119.10 Median:147.50 stddev:26.16 (17.7%) stddev-sans-first:25.24 07:45:07 INFO - PROCESS | 1855 | Values: 150.0 111.0 126.0 129.0 89.0 73.0 134.0 145.0 140.0 94.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#8] json-parse-financial Cycles:10 Average:63.30 Median:56.00 stddev:16.79 (30.0%) stddev-sans-first:16.60 07:45:07 INFO - PROCESS | 1855 | Values: 46.0 47.0 86.0 86.0 89.0 56.0 56.0 56.0 56.0 55.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#9] json-stringify-tinderbox Cycles:10 Average:82.70 Median:76.00 stddev:14.67 (19.3%) stddev-sans-first:14.56 07:45:07 INFO - PROCESS | 1855 | Values: 68.0 75.0 73.0 87.0 76.0 88.0 119.0 90.0 75.0 76.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#10] stanford-crypto-aes Cycles:10 Average:89.60 Median:86.00 stddev:11.62 (13.5%) stddev-sans-first:12.25 07:45:07 INFO - PROCESS | 1855 | Values: 86.0 86.0 90.0 86.0 87.0 90.0 115.0 76.0 103.0 77.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#11] stanford-crypto-ccm Cycles:10 Average:153.20 Median:154.00 stddev:12.72 (8.3%) stddev-sans-first:11.66 07:45:07 INFO - PROCESS | 1855 | Values: 135.0 167.0 151.0 148.0 174.0 147.0 140.0 157.0 167.0 146.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.90 Median:168.00 stddev:2.64 (1.6%) stddev-sans-first:2.71 07:45:07 INFO - PROCESS | 1855 | Values: 166.0 168.0 166.0 167.0 167.0 166.0 168.0 175.0 168.0 168.0 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - PROCESS | 1855 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:80.40 Median:85.00 stddev:8.72 (10.3%) stddev-sans-first:8.40 07:45:07 INFO - PROCESS | 1855 | Values: 70.0 81.0 85.0 85.0 92.0 75.0 70.0 69.0 88.0 89.0 07:45:07 INFO - PROCESS | 1855 | -------- Summary: end -------- 07:45:07 INFO - PROCESS | 1855 | 07:45:07 INFO - TEST-INFO | 1855: exit 0 07:45:07 INFO - TEST-OK | kraken | took 60718ms 07:45:07 INFO - SUITE-END | took 1173s 07:45:08 INFO - Completed test suite (00:19:34) 07:45:08 INFO - javascript benchmark 07:45:08 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7206.40222923345, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2852.557853532703, 3279.3246342349153, 3284.687954644309, 3332.7500437467165, 3341.331733653269, 4081.979590102049, 4552.339910712944, 4649.209634362158, 4836.581857858455, 5610.298712660918, 5573.916391254124, 5576.804811831586, 5576.944230557693, 5590.832275031746, 5611.186377975191, 5052.24216367546, 5060.240963855433, 5119.078565858144, 5175.611829112813, 5208.192730126836, 5187.351581052369, 5195.896082078356, 5211.5309622134, 5227.686338819683, 5228.843134705965, 5013.197888337867, 5066.46802085783, 5094.006668699605, 5128.384593848725, 5180.274761533388, 4999.75001249936, 5094.006668699605, 5096.974515127437, 5113.360829896263, 5139.871503212412, 4485.551444855521, 4816.807327706888, 5011.874703132415, 5036.370453693288, 5074.644774865761, 5373.811916582901, 5472.1244600864065, 5563.36021357545, 5607.915881261784, 5612.0, 6051.243594550681, 6101.237345331833, 6106.358832322587, 6118.632882027093, 6130.509559235251, 5378.704171270579, 5613.663180209201, 5672.773089076432, 6039.365866584033, 6151.661658608775, 5627.887442251132, 5659.0, 5667.1782591524, 5673.432656734376, 5752.626079304831, 5201.661891977085, 6257.74969001244, 6260.092286618415, 6265.530085243625, 6265.906011409833, 5772.624779389326, 5989.131575921554, 5995.46040856325, 6000.369961154103, 6025.246844144482, 5930.110483427434, 6056.909146362808, 6120.326764055951, 6129.389354848322, 6143.84640383994, 5991.161237426677, 6035.39646035393, 6049.122877182784, 6065.696715164224, 6072.301685306246, 6084.026555751058, 6102.0, 6132.294786099566, 6139.140520327158, 6139.631622102688, 4733.881652958635, 4834.371531700856, 4885.145099607555, 4906.386701662293, 4908.533689299511, 4352.194843953878, 4375.934360984587, 4390.846320378771, 4397.934030989538, 4422.579854913778, 5514.338279406416, 5568.582356323292, 5577.888442231214, 5585.0, 5611.887762244733, 5920.141579470953, 6100.974805932192, 6121.056693972082, 6130.356312587114, 6196.907046394308, 5526.834194974157, 5544.140658197985, 5555.30558680165, 5560.082586373203, 5569.554435645138, 4703.176944034849, 5336.386315573681, 5343.064963631349, 5359.222912677717, 5370.4629537045985, 5581.162825576115, 5737.655740655574, 6132.819519597625, 6166.506679465721, 6199.287081985539, 4930.901381972412, 5431.049566325798, 6101.974255744823, 6143.911070236141, 6173.32093469709, 6202.7208775606105, 6212.285587157535, 6216.875662486635, 6221.471174949999, 6262.060690896402, 5885.793997210077, 5976.850578735566, 6023.789167379121, 6048.758049677964, 6113.327533971171, 6053.636781793107, 6074.967255566653, 6140.50424869748, 6155.630662160284, 6156.938430615636, 5894.616849904743, 5924.674142922181, 5934.43622855828, 5939.703014849327, 5952.642841429528, 5688.947544704243, 5811.331696854916, 5914.526837852875, 5928.199693041384, 5997.880042399215, 5703.600747947604, 5707.372189059117, 5770.567207459373, 5771.94228057714, 5862.824115276549, 5976.491998180203, 5976.850578735566, 5989.131575921554, 5999.610025348338, 6004.369541198112, 5619.0, 5719.914201286901, 5748.827535173951, 5795.275590551181, 5840.883182336244], "value": 5513.442597486485, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [492.50995259716586, 522.7987224918406, 528.7065678548404, 534.6551474299077, 537.782198209725, 38157.80921095398, 41368.793156034255, 41386.79306603467, 41387.58612413879, 41534.792326038405, 42531.57468425315, 42966.92582685434, 43010.784946075306, 43038.13923721531, 43295.78352108243, 7696.960910277125, 9023.548822558878, 9814.46020468874, 9814.803703925934, 9822.508874556279, 9671.177949874269, 9783.755406114833, 9793.657221997231, 9802.117809397152, 9832.0, 8898.510581917992, 9809.166220871235, 9818.9509052455, 9867.654632087879, 9891.90108098917, 9767.951160244189, 9797.853032204523, 9804.0, 9805.31362804604, 9826.754331141707, 9697.90302096977, 9771.804563908752, 9780.951095244549, 9805.411675299505, 9822.754431139207, 32545.51181732276, 40339.0, 40348.0, 40490.59509404898, 40545.59454405477, 2669.292637451077, 3242.124626350872, 3300.174956260935, 3392.525046493493, 3516.964830351689, 29064.0, 30273.238695326116, 30487.932922347834, 30562.69437305621, 31348.843255783802, 3033.074912151793, 3040.255137491307, 3059.770517211196, 3070.6468756093113, 3162.7311678507126, 446303.0, 446797.7660111711, 447405.52594473964, 450034.0, 452780.73609632073, 34140.0, 34265.0, 34342.90913817768, 34381.96854094381, 34409.31181376358, 34921.0, 35124.82437587796, 35221.47167792485, 35571.11072223215, 36761.81619091887, 14524.564263072125, 16689.582760431087, 16833.747493787603, 16847.32610695583, 16868.32526698943, 12725.745485090247, 12791.0, 12816.102872799001, 12842.614721558368, 12848.550300739429, 19110.90444547796, 19375.224991000483, 19532.316368927302, 19552.315668951804, 19578.140076692693, 8044.678212871419, 8090.797730056795, 8105.55419451924, 8124.350051995826, 8205.261526462527, 877.5392918717597, 946.1484663802632, 1066.81330767117, 1094.020851338048, 1146.9655910322704, 25808.870955645103, 29383.706162938524, 30318.84840575783, 30959.0712278632, 31250.0, 1051.5373235776235, 1060.0141868062622, 1068.9251752377415, 1083.8320060390652, 1095.2608332338648, 15785.605359866095, 15795.763063554055, 15820.129892855774, 16058.0, 16310.918445407697, 558945.0, 561756.0, 563471.0, 566142.0, 568798.0, 58558.0, 59231.40768592345, 59678.40321596815, 59734.402655973754, 60104.699476503214, 1352.5063351876495, 1373.4094339433939, 1404.810350602676, 1406.592088294383, 1412.69627030189, 27337.863310684115, 29020.709792902646, 29823.254418639706, 30305.393892121592, 30486.390272194876, 42474.575254248295, 52737.20894186514, 52970.470295298095, 53027.73486132544, 53167.20249196188, 622826.0, 624188.0, 624831.0, 626866.0, 627483.0, 26670.19989400321, 26740.331491712863, 27065.72934270711, 27089.458210835277, 27098.0, 34321.79873704408, 37249.627503724616, 38879.6112038876, 46939.53060469488, 46997.76501117473, 32091.358172835946, 38461.230775384895, 39311.41032884452, 40186.39720404138, 40318.39522407108, 33064.18147001938, 38328.80835595804, 38492.80753596214, 38666.6133338663, 39825.0, 32708.0, 36241.27517449689, 39898.800505997286, 39902.800485998545, 40699.59300407077, 31990.840045800553, 34796.82601586976, 35004.91642084607, 35500.822495887354, 35661.64338356583, 21792.128314867863, 26127.0, 26455.867720661274, 26475.60286595664, 26548.469030619664], "value": 19307.642689351447, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [335.2339903320912, 378.77462909568817, 384.3024909788732, 387.6317498376543, 404.6742372390225, 16321.183940802957, 20015.0, 20786.584268314626, 21191.470213244676, 21392.57214855702, 16505.504834854943, 21118.944052797375, 21206.0, 21357.786422135774, 21583.892080539576, 5791.507721843648, 5844.853878653036, 5988.0, 6079.0, 6085.878282434349, 5951.58338916276, 5992.7902523411685, 6050.909236361458, 6061.333253342129, 6069.635821850681, 5191.792328306863, 5709.942900570983, 5863.5309175265875, 5923.940760592403, 6009.879802403972, 5914.3494215636465, 5922.082077278029, 5930.080837470199, 5930.347661757203, 5975.581709280352, 4989.800407983713, 5075.593952483792, 5142.3829140503, 5145.30538377318, 5162.586993040548, 26023.349416264744, 26087.73912260872, 26187.952481900702, 26202.86898565514, 26262.343441413926, 2405.20628192696, 2470.3206618179966, 3059.29636183679, 3070.355225402668, 3187.235063584746, 15531.611709707235, 15925.283362248727, 16021.35914563416, 16162.919185403998, 16236.350545978265, 1693.9243580326581, 1730.9181761399125, 1813.727940808876, 1843.797182309945, 1978.2482656590548, 95514.13457596283, 114247.0, 117940.0, 118253.0, 119348.8065119355, 9896.950515247378, 10307.690769276935, 10508.42203678805, 10811.567537298577, 10855.402952837512, 13520.0, 13625.795613065811, 13668.453261869414, 13680.247586382646, 13714.17714937087, 8312.376571757022, 8474.152584741476, 8561.571921403905, 8695.521746304014, 8730.995935467376, 7092.574445533284, 8701.782455438664, 8724.214820666171, 8880.73357799267, 8893.866592001124, 5606.719664016783, 5961.807638472236, 6485.337908949928, 6549.967250163814, 6801.4558835293055, 1758.5251981965055, 1833.5049536625304, 1881.303917550515, 1883.1808163448943, 1883.256113835055, 724.2540183610889, 808.2685169921231, 819.4264015189391, 952.8189643967625, 969.0, 17499.68752343554, 20693.379198624065, 21174.576508469745, 22588.887055564945, 22594.435139121655, 892.9687460938836, 925.9305552083621, 937.4703292639637, 957.4973139101888, 981.4503877828439, 9845.950770246103, 11249.481320021856, 11864.288142711464, 11990.940045299718, 12012.579559715368, 502303.0, 584356.0, 590784.0, 605422.0, 617555.0, 89014.0, 121099.5780084411, 125121.0, 125706.0, 126580.1012984806, 903.7243640689653, 957.2963871554402, 960.6397600899662, 965.2229954886244, 966.9468179250068, 18970.52573685669, 19266.0, 19371.61256774885, 19398.806011940265, 19401.0, 54829.0, 55278.0, 56169.43830561805, 56930.0, 57028.28915132552, 63635.0, 82012.58993705233, 83128.16871831204, 84271.0, 84508.57745711478, 7826.686932522635, 7924.286814186751, 8201.671933122847, 8207.384446166441, 8355.83288334242, 9122.452652840851, 12408.193467424588, 13020.869791302344, 13090.0, 13608.319584020957, 10666.520006599567, 10735.355878647306, 11272.605458808903, 11577.6526704199, 11651.0, 8733.606987685696, 11127.387993660426, 11385.089192864716, 11572.710682233012, 11666.824997624874, 11119.444027798416, 11631.709207269885, 11873.050155987328, 11890.940545297564, 11964.940175299067, 6811.69347379379, 8137.511749295061, 8328.375371847256, 8412.116727743498, 8441.746747597583, 9618.855717164388, 11564.768704626029, 11581.88418115808, 11606.24559403636, 11656.067514598642], "value": 9735.323582467496, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1532.2874863188615, 1547.9845201547985, 1764.0, 1852.7220916862461, 1874.9718754218682, 7908.446408751375, 8354.582270886454, 8571.0, 8836.513991730451, 8884.911150888498, 8570.142985701426, 8773.60518776655, 8774.034856165817, 8774.078721734222, 8790.34072444566, 2298.9540209195807, 2349.3539276698875, 2350.4476448034698, 2354.7409784923643, 2354.882255887199, 1952.3069310394746, 2339.894704738282, 2356.646503024543, 2357.281029286067, 2360.834741568091, 2327.3832434404894, 2331.6619090231907, 2342.8945697443655, 2344.9296521104393, 2356.6936298281285, 2307.9636170350013, 2320.5358928214423, 2333.9066437342485, 2335.719713634358, 2342.0, 2311.734150572672, 2319.686842276288, 2329.149860300995, 2330.5222429401933, 2330.9184178553837, 7745.535267883945, 8701.042885282613, 8727.0, 8761.693340733107, 8817.030126686059, 4360.345948107777, 5207.817726379559, 5292.655977361498, 5293.7617807198385, 5336.706481143536, 3357.2278375973665, 3392.8982130536124, 3462.342154990569, 3493.493443450711, 3546.6453354664586, 1001.5042553935848, 1046.638909576195, 1058.5501162006194, 1069.6309773128337, 1075.0, 11621.360825154614, 11624.825627615592, 11698.590549330818, 11702.53189872404, 11708.765824683544, 4525.456945166601, 4565.429321334833, 4726.361941137971, 4730.881727956828, 4758.42898852133, 9852.014798520235, 9938.602455901682, 9979.750506237402, 9980.550875210633, 10018.048285412875, 5341.786328546892, 5342.893142137135, 5345.919811202835, 5357.4106848246665, 5363.758630861621, 4352.151330490524, 4680.485146633868, 4822.758862056883, 4855.732934688626, 4907.993861258434, 3054.6639869614323, 3860.82626281818, 3924.9803750981064, 3970.3647416413237, 4028.8589899353383, 1282.6216266201493, 1296.8703129686955, 1299.4802079168408, 1306.405585458614, 1307.4181989014796, 901.4951627088851, 917.3945196170496, 921.4379228670506, 952.0051546134306, 962.3167551038841, 5774.105013722879, 5925.970370148121, 5992.460678538952, 6100.115483254903, 6119.418655227746, 380.7353889047141, 434.60450989599315, 443.72267332916925, 450.5246964452534, 451.34329550504594, 3905.1799122184093, 3907.8632247871187, 4018.799060046986, 4023.657989070903, 4033.9193216135513, 10398.792024159475, 10765.623203187852, 10806.459677016117, 10812.72968175786, 10813.134949204203, 10721.83917241242, 10751.569937202425, 10790.028897399272, 10797.514111864828, 10821.134309255242, 6797.796066118024, 8024.037115546055, 8091.745779404202, 8227.794305142419, 8247.95876020616, 5761.337446193574, 5832.387599302012, 5850.356460789395, 5864.648121112747, 5869.35437101927, 9888.060634239735, 9957.352772069793, 9975.60097596088, 9997.900020999989, 10074.8488772667, 9898.257630677585, 10162.89837101649, 10231.823340315661, 10311.175105991353, 10326.0, 6919.377256046779, 7393.852122957618, 7522.059742532184, 7545.056867891513, 7608.505447145918, 8258.793530161794, 8289.544075075928, 8304.335653147855, 8317.792055198668, 8324.0, 7387.4090072795125, 7503.66233519482, 7515.473916825988, 7563.432742544222, 7630.961845190738, 7251.891221631574, 7317.817054573678, 7351.228121047213, 7443.962780186064, 7473.6263186841525, 6864.347886950732, 7004.964975175295, 7031.542949708252, 7033.859322813618, 7034.753783617549, 4793.448753393404, 4948.257761335828, 4978.751062446936, 4992.900141997067, 5096.388433388017, 4829.010052939209, 4937.456879743298, 5029.59763218949, 5129.076766182123, 5166.173412254172], "value": 4480.099036387836, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [272.8076705922325, 306.08175473579263, 309.81565968248884, 311.5451440896291, 314.86932922837025, 4563.863084107474, 4694.8262934266395, 5319.707416092114, 5415.83752487425, 5567.276254086968, 4718.480967093626, 5473.370562385327, 5509.752061157247, 5512.9173062404, 5524.640898341605, 3501.9863578442496, 3531.611522732497, 3919.0006548330134, 4238.321868501041, 4261.552536983619, 3500.3524347995576, 3653.3058718843467, 4109.301418758803, 4253.340732186516, 4280.614744672979, 3277.754168437365, 4039.131586708857, 4070.857519986801, 4084.060666046811, 4095.4266402703647, 3578.320119177374, 4091.488563929509, 4097.405876147972, 4118.382242663594, 4140.37894315852, 3470.1151206442446, 3573.0, 3588.0132963435003, 3600.71194304455, 3626.3110009098186, 4468.7710879508395, 4906.632002599784, 4956.628252881048, 5211.7394130293715, 5467.097928841737, 4306.870793876189, 4346.9132716820795, 4433.290673492258, 4495.865124046284, 4674.883127921795, 5728.369879313273, 5736.2256095427, 5749.338826034976, 5754.367019627837, 5803.968610986163, 3069.478188707925, 3758.590528551793, 3803.315403227418, 3877.418387241908, 3920.7255492115564, 4966.255061740731, 5967.403259674042, 6101.169649105295, 6122.204113465265, 6187.226596675416, 3301.092199645117, 3646.6171052039153, 3928.958825911136, 3955.940660890089, 3962.5046869141356, 3709.573399059089, 3869.10413897194, 3969.226000929791, 4007.198560287954, 4021.4369988201674, 4072.063425412172, 4073.06319546506, 4274.978625106854, 4594.65540084495, 4692.835750748775, 4650.465196502378, 5721.113227449752, 5786.363500014995, 5823.301203855564, 5825.912611310834, 1253.6239128261484, 1260.9345103387623, 1275.145652412867, 1322.0415198980854, 1352.939117739704, 749.336836899348, 909.7407238937003, 916.6333466613409, 918.2011649864661, 921.2123634292717, 4213.578642135762, 4571.885702857388, 5210.947890521122, 5211.921821172609, 5215.634905556651, 5750.741216645261, 5751.166080918327, 5760.279965004374, 5785.421457854265, 5786.479216870502, 4781.641376896747, 4867.805287788519, 4954.950450495521, 5105.821296254688, 5213.322268105122, 2251.1203145373797, 2413.3483959331234, 2487.8756062196817, 2640.5115053715126, 2644.3256969472664, 4522.683412161183, 4861.732604706775, 5064.392272927199, 5101.362329708786, 5116.083832215601, 3878.728489005799, 4127.484064491939, 4513.232750432434, 4930.964497455503, 5145.768440420115, 4186.8341000704495, 4652.790624421977, 5133.666311689728, 5178.368813823634, 5245.659032162897, 4414.514403415557, 4543.3639290498695, 4603.079384123122, 4932.876678082933, 5101.729730269994, 4220.66234701217, 4493.505714371351, 4909.877253068702, 4963.255511673278, 5000.699818047407, 4180.088396134591, 4566.70316429431, 4685.922237885237, 5105.642605017613, 5133.948660513347, 2921.8962347110046, 2944.455275773989, 3013.3370658455983, 3474.3398754236614, 3481.199324155509, 4022.416749571354, 4654.394928659252, 5024.723640199678, 5169.4830516948, 5639.464250896158, 4525.502194758508, 5711.800086997101, 5748.109043098327, 5755.453231942959, 5839.708014599168, 5765.731539061399, 5776.971115144397, 5780.739866705924, 5798.927198468297, 5817.283901249226, 5232.0, 5611.915821262603, 5648.943510564842, 5682.772689092555, 5691.60555663865, 5835.8832823342445, 5866.829273168954, 5912.526997840077, 5918.408159184047, 5939.613925094855, 4345.000649850615, 5773.797917072882, 5839.0, 5858.853528661647, 5907.202527658883], "value": 3946.7601268545263, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [693.7883945396652, 765.7779244019234, 766.904136982877, 794.9721759738403, 876.618670878168, 15299.694006119886, 15948.521544353658, 15957.920210398946, 15966.84033159668, 15975.201239937986, 14084.929575352135, 14357.0, 14489.347979340955, 14499.20254386011, 14540.781888271684, 751.6993202718902, 839.6809212499242, 888.6356593796545, 899.6626265150569, 904.8552231642939, 845.5096044294326, 870.1776820904248, 884.7876509637673, 894.5259012723235, 898.3846065445191, 902.440486898124, 932.8600709893502, 937.653068364706, 939.2392162348519, 939.9859002114973, 920.1442658327786, 926.990730092704, 928.0951072704094, 928.9489078100769, 929.1591110045385, 589.6609449566473, 681.7852376501386, 694.5763084518439, 694.8957656351537, 701.1060897355861, 15264.694706105927, 15587.298571564306, 15590.454334098253, 15625.3749850007, 15632.921835390864, 14123.435062597484, 14126.152430854181, 14276.57170284893, 14285.357158927769, 14497.0, 11786.646400607995, 11806.40967951599, 11931.40342982856, 12025.278483290944, 12186.207896486789, 3767.660910518039, 3797.9240415191816, 3807.428885667144, 3835.5972622874756, 3891.377379619247, 106554.46722766414, 108281.0, 117717.41141294324, 118146.22780658297, 119584.0, 10367.896321036844, 10424.414084744216, 10565.9471702641, 10622.20333474977, 10829.512671929782, 21959.231426899983, 22261.3321600349, 22452.0, 22496.437589060406, 22523.099076036775, 7866.213378662088, 8000.0, 8013.8397232056195, 8024.799380015546, 8065.39509536787, 3767.3407153747985, 4562.292844609091, 4566.520515345907, 4572.474165470947, 4730.030343779517, 3173.793958295879, 3648.069742215718, 3760.4923335349927, 3764.284785890672, 3773.2264885698364, 574.371063685264, 598.6557729305666, 615.2432508015166, 624.7879114517912, 628.7107930351998, 507.7106049551794, 665.1685393258427, 690.6926417744156, 700.9205823032574, 708.9645517724093, 9132.589033493508, 9559.761005974768, 9739.26955478342, 9769.462679552551, 9819.75450613726, 597.8893904627657, 613.2640831002815, 625.7465726380823, 625.8591816841265, 628.3496581038603, 4487.855596822789, 4601.056783359403, 4674.719516829001, 4678.649101317346, 4700.271457924027, 136819.31590341983, 149969.0, 150291.49708502993, 152842.8862845496, 155958.66062009078, 121475.39262303631, 121691.0, 127962.0, 131670.0, 133177.0, 96038.51980740052, 102629.0, 106372.68136593293, 108793.0, 108841.0, 7084.752033678797, 8654.264387527131, 9087.954560227421, 9236.769080772765, 9349.345545812, 53234.13680521163, 60117.69941150266, 62205.68897155485, 63233.10300690986, 64693.67653161704, 79190.6040469794, 90553.92159310485, 100343.31432665577, 101177.97644046931, 101264.0, 11580.710482238012, 11685.649430517098, 11784.410779461165, 12070.336131512851, 12429.813552796897, 10523.631672891412, 10923.508442119964, 13007.674808129872, 13470.124441911245, 13688.0, 10244.897551024394, 10922.344659320466, 12752.043596730096, 12858.935705321413, 12889.226646401246, 11891.464884080064, 12231.143819932518, 12348.506059757508, 12689.111762176928, 12729.681757956125, 10433.791324173322, 11890.881091188978, 12596.055295852664, 12630.0, 12654.177478463871, 7039.507234493536, 9115.635374584943, 9261.120193581599, 9350.525830852548, 9989.950050249703, 8090.775036864909, 8894.155055269739, 8992.370534062553, 9478.763030924281, 9709.36889102206], "value": 7642.440596645232, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1602.3000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 117.0, 108.0, 120.0, 117.0, 117.0, 115.0, 117.0, 118.0, 118.0], "value": 115.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 123.0, 167.0, 189.0, 112.0, 134.0, 117.0, 138.0, 183.0, 110.0], "value": 141.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [207.0, 238.0, 212.0, 283.0, 241.0, 200.0, 202.0, 198.0, 201.0, 192.0], "value": 217.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 86.0, 74.0, 143.0, 59.0, 59.0, 59.0, 62.0, 135.0, 58.0], "value": 80.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 71.0, 124.0, 70.0, 72.0, 85.0, 116.0, 70.0, 73.0, 143.0], "value": 89.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 82.0, 89.0, 86.0, 90.0, 87.0, 89.0, 87.0, 89.0, 89.0], "value": 87.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 104.0, 94.0, 123.0, 107.0, 106.0, 156.0, 155.0, 102.0, 95.0], "value": 113.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 111.0, 126.0, 129.0, 89.0, 73.0, 134.0, 145.0, 140.0, 94.0], "value": 119.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [46.0, 47.0, 86.0, 86.0, 89.0, 56.0, 56.0, 56.0, 56.0, 55.0], "value": 63.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 75.0, 73.0, 87.0, 76.0, 88.0, 119.0, 90.0, 75.0, 76.0], "value": 82.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 86.0, 90.0, 86.0, 87.0, 90.0, 115.0, 76.0, 103.0, 77.0], "value": 89.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [135.0, 167.0, 151.0, 148.0, 174.0, 147.0, 140.0, 157.0, 167.0, 146.0], "value": 153.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 168.0, 166.0, 167.0, 167.0, 166.0, 168.0, 175.0, 168.0, 168.0], "value": 167.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 81.0, 85.0, 85.0, 92.0, 75.0, 70.0, 69.0, 88.0, 89.0], "value": 80.4, "unit": "score"}]}]} 07:45:08 INFO - Return code: 0 07:45:08 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 07:45:08 ERROR - # TBPL SUCCESS # 07:45:08 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 07:45:08 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 07:45:08 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 07:45:08 INFO - 2016-08-11 07:45:08.330 screenresolution[1866:11043] starting screenresolution argv=screenresolution get 07:45:08 INFO - 2016-08-11 07:45:08.332 screenresolution[1866:11043] Display 0: 1600x1200x32@60 07:45:08 INFO - 2016-08-11 07:45:08.338 screenresolution[1867:11046] starting screenresolution argv=screenresolution list 07:45:08 INFO - Available Modes on Display 0 07:45:08 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 07:45:08 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 07:45:08 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 07:45:08 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 07:45:08 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 07:45:08 INFO - Intel Iris: 07:45:08 INFO - Chipset Model: Intel Iris 07:45:08 INFO - Type: GPU 07:45:08 INFO - Bus: Built-In 07:45:08 INFO - VRAM (Dynamic, Max): 1536 MB 07:45:08 INFO - Vendor: Intel (0x8086) 07:45:08 INFO - Device ID: 0x0a2e 07:45:08 INFO - Revision ID: 0x0009 07:45:08 INFO - Displays: 07:45:08 INFO - Display: 07:45:08 INFO - Resolution: 1600 x 1200 @ 60 Hz 07:45:08 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 07:45:08 INFO - Display Serial Number: 1600x1200 60 07:45:08 INFO - Main Display: Yes 07:45:08 INFO - Mirror: Off 07:45:08 INFO - Online: Yes 07:45:08 INFO - Rotation: Supported 07:45:08 INFO - Return code: 0 07:45:08 INFO - Running post-action listener: _resource_record_post_action 07:45:08 INFO - [mozharness: 2016-08-11 14:45:08.574384Z] Finished run-tests step (success) 07:45:08 INFO - Running post-run listener: _resource_record_post_run 07:45:08 INFO - Total resource usage - Wall time: 1208s; CPU: 55.0%; Read bytes: 32992256; Write bytes: 708712448; Read time: 312; Write time: 2097 07:45:08 INFO - TinderboxPrint: CPU usage
54.5% 07:45:08 INFO - TinderboxPrint: I/O read bytes / time
32,992,256 / 312 07:45:08 INFO - TinderboxPrint: I/O write bytes / time
708,712,448 / 2,097 07:45:08 INFO - TinderboxPrint: CPU idle
2,198.7 (45.5%) 07:45:08 INFO - TinderboxPrint: CPU system
978.1 (20.2%) 07:45:08 INFO - TinderboxPrint: CPU user
1,656.7 (34.3%) 07:45:08 INFO - TinderboxPrint: Swap in / out
433,410,048 / 0 07:45:08 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 382808576; Write bytes: 376561664; Read time: 28185; Write time: 693 07:45:08 INFO - run-tests - Wall time: 1175s; CPU: 55.0%; Read bytes: 32054272; Write bytes: 302602240; Read time: 298; Write time: 1347 07:45:09 INFO - Running post-run listener: _upload_blobber_files 07:45:09 INFO - Blob upload gear active. 07:45:09 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:45:09 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 07:45:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:45:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:45:09 INFO - (blobuploader) - INFO - Open directory for files ... 07:45:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:45:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:45:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:45:10 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:45:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:45:10 INFO - (blobuploader) - INFO - Done attempting. 07:45:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:45:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:45:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:45:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:45:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:45:11 INFO - (blobuploader) - INFO - Done attempting. 07:45:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 07:45:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:45:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:45:13 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 07:45:13 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:45:13 INFO - (blobuploader) - INFO - Done attempting. 07:45:13 INFO - (blobuploader) - INFO - Iteration through files over. 07:45:13 INFO - Return code: 0 07:45:13 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:45:13 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:45:13 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/dbd1c04a3f3ab6b380453dc73857baae08cf3995dbdfb1d0c8d026294a2fc719876ee05c089373d20c42ad92e87dff8002f16de9d035eaf2dc2589d54faa4753", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ef18bde017d83b8890d1d8a2d8cd3045167bece11b3b25bf81d212afd29a08d15872ae2292873c8d73c7fc04f14e6e7cad1842c0af130e4e32c143abacb6933b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/089e03bc66c57954c0f4da2bb2e8b90c31064c563a885481bfb22062ebd989b39fb3a4b703ce09da612d5988cd4ee68bb07bd7fa19498ec653971c33837d15a1"} 07:45:13 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:45:13 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:45:13 INFO - Contents: 07:45:13 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/dbd1c04a3f3ab6b380453dc73857baae08cf3995dbdfb1d0c8d026294a2fc719876ee05c089373d20c42ad92e87dff8002f16de9d035eaf2dc2589d54faa4753", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ef18bde017d83b8890d1d8a2d8cd3045167bece11b3b25bf81d212afd29a08d15872ae2292873c8d73c7fc04f14e6e7cad1842c0af130e4e32c143abacb6933b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/089e03bc66c57954c0f4da2bb2e8b90c31064c563a885481bfb22062ebd989b39fb3a4b703ce09da612d5988cd4ee68bb07bd7fa19498ec653971c33837d15a1"} 07:45:13 INFO - Running post-run listener: copy_logs_to_upload_dir 07:45:13 INFO - Copying logs to upload dir... 07:45:13 INFO - mkdir: /builds/slave/test/build/upload/logs 07:45:13 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1264.521013 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2016-08-11 07:45:14.034926) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-11 07:45:14.038735) ========= 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.all9v01wS1/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.Z1RQAvTd8p/Listeners TMPDIR=/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/dbd1c04a3f3ab6b380453dc73857baae08cf3995dbdfb1d0c8d026294a2fc719876ee05c089373d20c42ad92e87dff8002f16de9d035eaf2dc2589d54faa4753", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ef18bde017d83b8890d1d8a2d8cd3045167bece11b3b25bf81d212afd29a08d15872ae2292873c8d73c7fc04f14e6e7cad1842c0af130e4e32c143abacb6933b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/089e03bc66c57954c0f4da2bb2e8b90c31064c563a885481bfb22062ebd989b39fb3a4b703ce09da612d5988cd4ee68bb07bd7fa19498ec653971c33837d15a1"} build_url:https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011329 build_url: 'https://queue.taskcluster.net/v1/task/HjF4J53kTj2nWdN_KPv06w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/dbd1c04a3f3ab6b380453dc73857baae08cf3995dbdfb1d0c8d026294a2fc719876ee05c089373d20c42ad92e87dff8002f16de9d035eaf2dc2589d54faa4753", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ef18bde017d83b8890d1d8a2d8cd3045167bece11b3b25bf81d212afd29a08d15872ae2292873c8d73c7fc04f14e6e7cad1842c0af130e4e32c143abacb6933b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/089e03bc66c57954c0f4da2bb2e8b90c31064c563a885481bfb22062ebd989b39fb3a4b703ce09da612d5988cd4ee68bb07bd7fa19498ec653971c33837d15a1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-11 07:45:14.071215) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-11 07:45:14.071556) ========= 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.all9v01wS1/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.Z1RQAvTd8p/Listeners TMPDIR=/var/folders/vs/0sk_gyqd48x911v5vww2j48c00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005236 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-11 07:45:14.120168) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-11 07:45:14.120514) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-11 07:45:14.120854) ========= ========= Total master_lag: 0.37 =========