builder: mozilla-aurora_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0320 starttime: 1487088461.27 results: success (0) buildid: 20170214064945 builduid: 4f1dc1bc44814092bdfa8371e3ff4d05 revision: a57e10371afcb34942a2df45004348b96f429919 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:41.271923) ========= master: http://buildbot-master133.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:41.272382) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:41.272660) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:41.296935) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:41.297195) ========= 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.VbCcMtJyln/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.5kW3qGWzlf/Listeners TMPDIR=/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 --2017-02-14 08:07:41-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 6.30M=0.002s 2017-02-14 08:07:41 (6.30 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.128793 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:41.448420) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:41.448731) ========= 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.VbCcMtJyln/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.5kW3qGWzlf/Listeners TMPDIR=/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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.019170 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:41.499873) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-02-14 08:07:41.500226) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev a57e10371afcb34942a2df45004348b96f429919 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev a57e10371afcb34942a2df45004348b96f429919 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.VbCcMtJyln/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.5kW3qGWzlf/Listeners TMPDIR=/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 2017-02-14 08:07:41,541 truncating revision to first 12 chars 2017-02-14 08:07:41,542 Setting DEBUG logging. 2017-02-14 08:07:41,542 attempt 1/10 2017-02-14 08:07:41,542 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/a57e10371afc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-14 08:07:42,621 unpacking tar archive at: mozilla-aurora-a57e10371afc/testing/mozharness/ program finished with exit code 0 elapsedTime=1.345298 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-02-14 08:07:42.872808) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:42.873175) ========= script_repo_revision: a57e10371afcb34942a2df45004348b96f429919 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:42.876585) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:42.876853) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-14 08:07:42.896143) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2017-02-14 08:07:42.896422) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.VbCcMtJyln/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.5kW3qGWzlf/Listeners TMPDIR=/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:07:43 INFO - MultiFileLogger online at 20170214 08:07:43 in /builds/slave/test 08:07:43 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 08:07:43 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:07:43 INFO - {'append_to_log': False, 08:07:43 INFO - 'base_work_dir': '/builds/slave/test', 08:07:43 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:07:43 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:07:43 INFO - 'branch': 'Mozilla-Aurora', 08:07:43 INFO - 'buildbot_json_path': 'buildprops.json', 08:07:43 INFO - 'config_files': ('talos/mac_config.py',), 08:07:43 INFO - 'default_actions': ('clobber', 08:07:43 INFO - 'read-buildbot-config', 08:07:43 INFO - 'download-and-extract', 08:07:43 INFO - 'populate-webroot', 08:07:43 INFO - 'create-virtualenv', 08:07:43 INFO - 'install', 08:07:43 INFO - 'run-tests'), 08:07:43 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:07:43 INFO - 'download_minidump_stackwalk': True, 08:07:43 INFO - 'download_symbols': 'ondemand', 08:07:43 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:07:43 INFO - 'tooltool.py': '/tools/tooltool.py', 08:07:43 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:07:43 INFO - '/tools/misc-python/virtualenv.py')}, 08:07:43 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:07:43 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:07:43 INFO - 'installer_path': 'installer.exe', 08:07:43 INFO - 'log_level': 'info', 08:07:43 INFO - 'log_name': 'talos', 08:07:43 INFO - 'log_to_console': True, 08:07:43 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 08:07:43 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 08:07:43 INFO - 'opt_config_files': (), 08:07:43 INFO - 'pip_index': False, 08:07:43 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:07:43 INFO - 'cmd': ('bash', 08:07:43 INFO - '-c', 08:07:43 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:07:43 INFO - 'enabled': True, 08:07:43 INFO - 'halt_on_failure': False, 08:07:43 INFO - 'name': 'check_screen_resolution'},), 08:07:43 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:07:43 INFO - 'cmd': ('bash', 08:07:43 INFO - '-c', 08:07:43 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:07:43 INFO - 'enabled': True, 08:07:43 INFO - 'halt_on_failure': False, 08:07:43 INFO - 'name': 'check_screen_resolution'},), 08:07:43 INFO - 'run_cmd_checks_enabled': True, 08:07:43 INFO - 'sps_profile': False, 08:07:43 INFO - 'sps_profile_interval': 0, 08:07:43 INFO - 'suite': 'dromaeojs', 08:07:43 INFO - 'system_bits': '32', 08:07:43 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:07:43 INFO - 'title': 't-yosemite-r7-0320', 08:07:43 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:07:43 INFO - 'use_talos_json': True, 08:07:43 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:07:43 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:07:43 INFO - 'work_dir': 'build'} 08:07:43 INFO - [mozharness: 2017-02-14 16:07:43.050899Z] Running clobber step. 08:07:43 INFO - Running pre-action listener: _resource_record_pre_action 08:07:43 INFO - Running main action method: clobber 08:07:43 INFO - rmtree: /builds/slave/test/build 08:07:43 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:07:43 INFO - Running post-action listener: _resource_record_post_action 08:07:43 INFO - [mozharness: 2017-02-14 16:07:43.947340Z] Finished clobber step (success) 08:07:43 INFO - [mozharness: 2017-02-14 16:07:43.947507Z] Running read-buildbot-config step. 08:07:43 INFO - Running pre-action listener: _resource_record_pre_action 08:07:43 INFO - Running main action method: read_buildbot_config 08:07:43 INFO - Using buildbot properties: 08:07:43 INFO - { 08:07:43 INFO - "project": "", 08:07:43 INFO - "product": "firefox", 08:07:43 INFO - "script_repo_revision": "production", 08:07:43 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs", 08:07:43 INFO - "repository": "", 08:07:43 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs", 08:07:43 INFO - "buildid": "20170214064945", 08:07:43 INFO - "pgo_build": "False", 08:07:43 INFO - "basedir": "/builds/slave/test", 08:07:43 INFO - "buildnumber": 5, 08:07:43 INFO - "slavename": "t-yosemite-r7-0320", 08:07:43 INFO - "master": "http://buildbot-master133.bb.releng.scl3.mozilla.com:8201/", 08:07:43 INFO - "platform": "yosemite_r7", 08:07:43 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 08:07:43 INFO - "branch": "mozilla-aurora", 08:07:43 INFO - "repo_path": "releases/mozilla-aurora", 08:07:43 INFO - "revision": "a57e10371afcb34942a2df45004348b96f429919", 08:07:43 INFO - "stage_platform": "macosx64", 08:07:43 INFO - "builduid": "4f1dc1bc44814092bdfa8371e3ff4d05", 08:07:43 INFO - "slavebuilddir": "test" 08:07:43 INFO - } 08:07:43 INFO - Found installer url https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg. 08:07:43 INFO - Running post-action listener: _resource_record_post_action 08:07:43 INFO - [mozharness: 2017-02-14 16:07:43.950994Z] Finished read-buildbot-config step (success) 08:07:43 INFO - [mozharness: 2017-02-14 16:07:43.951106Z] Running download-and-extract step. 08:07:43 INFO - Running pre-action listener: _resource_record_pre_action 08:07:43 INFO - Running main action method: download_and_extract 08:07:43 INFO - mkdir: /builds/slave/test/build/tests 08:07:43 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')]} 08:07:43 INFO - trying https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.test_packages.json 08:07:43 INFO - Downloading https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-53.0a2.en-US.mac.test_packages.json 08:07:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-53.0a2.en-US.mac.test_packages.json'}, attempt #1 08:07:44 INFO - Downloaded 1199 bytes. 08:07:44 INFO - Reading from file /builds/slave/test/build/firefox-53.0a2.en-US.mac.test_packages.json 08:07:44 INFO - Using the following test package requirements: 08:07:44 INFO - {u'common': [u'firefox-53.0a2.en-US.mac.common.tests.zip'], 08:07:44 INFO - u'cppunittest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 08:07:44 INFO - u'firefox-53.0a2.en-US.mac.cppunittest.tests.zip'], 08:07:44 INFO - u'gtest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 08:07:44 INFO - u'firefox-53.0a2.en-US.mac.gtest.tests.zip'], 08:07:44 INFO - u'jittest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 08:07:44 INFO - u'jsshell-mac.zip'], 08:07:44 INFO - u'mochitest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 08:07:44 INFO - u'firefox-53.0a2.en-US.mac.mochitest.tests.zip'], 08:07:44 INFO - u'mozbase': [u'firefox-53.0a2.en-US.mac.common.tests.zip'], 08:07:44 INFO - u'reftest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 08:07:44 INFO - u'firefox-53.0a2.en-US.mac.reftest.tests.zip'], 08:07:44 INFO - u'talos': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 08:07:44 INFO - u'firefox-53.0a2.en-US.mac.talos.tests.zip'], 08:07:44 INFO - u'web-platform': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 08:07:44 INFO - u'firefox-53.0a2.en-US.mac.web-platform.tests.zip'], 08:07:44 INFO - u'xpcshell': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 08:07:44 INFO - u'firefox-53.0a2.en-US.mac.xpcshell.tests.zip']} 08:07:44 INFO - Downloading packages: [u'firefox-53.0a2.en-US.mac.common.tests.zip'] for test suite category: common 08:07:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip 08:07:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip'}, attempt #1 08:07:44 INFO - Fetch https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip into memory 08:07:45 INFO - Expected file size: 16358363 08:07:45 INFO - Obtained file size: 16358363 08:07:51 INFO - Downloading packages: [u'firefox-53.0a2.en-US.mac.common.tests.zip', u'firefox-53.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 08:07:51 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip 08:07:51 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip'}, attempt #1 08:07:51 INFO - Fetch https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip into memory 08:07:52 INFO - Expected file size: 16358363 08:07:52 INFO - Obtained file size: 16358363 08:07:59 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.talos.tests.zip 08:07:59 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.talos.tests.zip'}, attempt #1 08:07:59 INFO - Fetch https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.talos.tests.zip into memory 08:08:00 INFO - Expected file size: 14403485 08:08:00 INFO - Obtained file size: 14403485 08:08:00 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')]} 08:08:00 INFO - trying https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg 08:08:00 INFO - Downloading https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-53.0a2.en-US.mac.dmg 08:08:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-53.0a2.en-US.mac.dmg'}, attempt #1 08:08:02 INFO - Downloaded 73950878 bytes. 08:08:02 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg 08:08:02 INFO - mkdir: /builds/slave/test/properties 08:08:02 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:08:02 INFO - Writing to file /builds/slave/test/properties/build_url 08:08:02 INFO - Contents: 08:08:02 INFO - build_url:https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg 08:08:03 INFO - Running post-action listener: _resource_record_post_action 08:08:03 INFO - Running post-action listener: set_extra_try_arguments 08:08:03 INFO - [mozharness: 2017-02-14 16:08:03.065234Z] Finished download-and-extract step (success) 08:08:03 INFO - [mozharness: 2017-02-14 16:08:03.065389Z] Running populate-webroot step. 08:08:03 INFO - Running pre-action listener: _resource_record_pre_action 08:08:03 INFO - Running main action method: populate_webroot 08:08:03 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:08:03 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:08:03 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:08:03 INFO - '--tppagecycles', 08:08:03 INFO - '7'], 08:08:03 INFO - 'tests': ['tsvgm']}}, 08:08:03 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:08:03 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:08:03 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:08:03 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:08:03 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 08:08:03 INFO - 'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:08:03 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:08:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:08:03 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 08:08:03 INFO - 'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['damp', 'tps']}, 08:08:03 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:08:03 INFO - 'tests': ['damp', 'tps']}, 08:08:03 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['dromaeo_dom']}, 08:08:03 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:08:03 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['basic_compositor_video']}, 08:08:03 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:08:03 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['a11yr', 08:08:03 INFO - 'ts_paint', 08:08:03 INFO - 'tpaint', 08:08:03 INFO - 'sessionrestore', 08:08:03 INFO - 'sessionrestore_no_auto_restore', 08:08:03 INFO - 'tabpaint']}, 08:08:03 INFO - 'other-e10s': {'tests': ['a11yr', 08:08:03 INFO - 'ts_paint', 08:08:03 INFO - 'tpaint', 08:08:03 INFO - 'sessionrestore', 08:08:03 INFO - 'sessionrestore_no_auto_restore', 08:08:03 INFO - 'tabpaint']}, 08:08:03 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:08:03 INFO - 'ts_paint', 08:08:03 INFO - 'tpaint', 08:08:03 INFO - 'sessionrestore', 08:08:03 INFO - 'sessionrestore_no_auto_restore', 08:08:03 INFO - 'tabpaint']}, 08:08:03 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:08:03 INFO - 'ts_paint', 08:08:03 INFO - 'tpaint', 08:08:03 INFO - 'sessionrestore', 08:08:03 INFO - 'sessionrestore_no_auto_restore', 08:08:03 INFO - 'tabpaint']}, 08:08:03 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['a11yr', 08:08:03 INFO - 'ts_paint', 08:08:03 INFO - 'tpaint', 08:08:03 INFO - 'sessionrestore', 08:08:03 INFO - 'sessionrestore_no_auto_restore', 08:08:03 INFO - 'tabpaint']}, 08:08:03 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['a11yr', 08:08:03 INFO - 'ts_paint', 08:08:03 INFO - 'tpaint', 08:08:03 INFO - 'sessionrestore', 08:08:03 INFO - 'sessionrestore_no_auto_restore', 08:08:03 INFO - 'tabpaint']}, 08:08:03 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['tsvgx', 08:08:03 INFO - 'tsvgr_opacity', 08:08:03 INFO - 'tart', 08:08:03 INFO - 'tscrollx', 08:08:03 INFO - 'cart', 08:08:03 INFO - 'tsvg_static']}, 08:08:03 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:08:03 INFO - 'tsvgr_opacity', 08:08:03 INFO - 'tart', 08:08:03 INFO - 'tscrollx', 08:08:03 INFO - 'cart', 08:08:03 INFO - 'tsvg_static']}, 08:08:03 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 08:08:03 INFO - 'talos_options': ['--disable-e10s'], 08:08:03 INFO - 'tests': ['tp5o']}, 08:08:03 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:08:03 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 08:08:03 INFO - 'talos_options': ['--disable-e10s', 08:08:03 INFO - '--xperf_path', 08:08:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:08:03 INFO - 'tests': ['tp5n']}, 08:08:03 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:08:03 INFO - 'talos_options': ['--xperf_path', 08:08:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:08:03 INFO - 'tests': ['tp5n']}}, 08:08:03 INFO - 'talos.zip': {'path': '', 08:08:03 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:08:03 INFO - Running post-action listener: _resource_record_post_action 08:08:03 INFO - [mozharness: 2017-02-14 16:08:03.083969Z] Finished populate-webroot step (success) 08:08:03 INFO - [mozharness: 2017-02-14 16:08:03.084079Z] Running create-virtualenv step. 08:08:03 INFO - Running pre-action listener: _resource_record_pre_action 08:08:03 INFO - Running main action method: create_virtualenv 08:08:03 INFO - Creating virtualenv /builds/slave/test/build/venv 08:08:03 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 08:08:03 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:08:03 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:08:03 INFO - Using real prefix '/tools/python27' 08:08:03 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:08:03 INFO - Installing distribute.............................................................................................................................................................................................done. 08:08:06 INFO - Installing pip.................done. 08:08:06 INFO - Return code: 0 08:08:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:08:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:08:07 INFO - Reading from file tmpfile_stdout 08:08:07 INFO - Output received: 08:08:07 INFO - pip 1.5.5 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 08:08:07 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:08:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:07 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:07 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 08:08:07 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 08:08:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:07 INFO - 'HOME': '/Users/cltbld', 08:08:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:07 INFO - 'LOGNAME': 'cltbld', 08:08:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:07 INFO - 'MOZ_NO_REMOTE': '1', 08:08:07 INFO - 'NO_EM_RESTART': '1', 08:08:07 INFO - 'PAGER': '/bin/cat', 08:08:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:07 INFO - 'PWD': '/builds/slave/test', 08:08:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:07 INFO - 'SHELL': '/bin/bash', 08:08:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:07 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:07 INFO - 'USER': 'cltbld', 08:08:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:07 INFO - 'XPC_FLAGS': '0x0', 08:08:07 INFO - 'XPC_SERVICE_NAME': '0', 08:08:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:07 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 08:08:07 INFO - Cleaning up... 08:08:07 INFO - Return code: 0 08:08:07 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:08:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:07 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:07 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 08:08:07 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 08:08:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:07 INFO - 'HOME': '/Users/cltbld', 08:08:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:07 INFO - 'LOGNAME': 'cltbld', 08:08:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:07 INFO - 'MOZ_NO_REMOTE': '1', 08:08:07 INFO - 'NO_EM_RESTART': '1', 08:08:07 INFO - 'PAGER': '/bin/cat', 08:08:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:07 INFO - 'PWD': '/builds/slave/test', 08:08:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:07 INFO - 'SHELL': '/bin/bash', 08:08:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:07 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:07 INFO - 'USER': 'cltbld', 08:08:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:07 INFO - 'XPC_FLAGS': '0x0', 08:08:07 INFO - 'XPC_SERVICE_NAME': '0', 08:08:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:07 INFO - Downloading/unpacking psutil>=3.1.1 08:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:08:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:08:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:08:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:08:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:08:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:08:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:08:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:08:11 INFO - Installing collected packages: psutil 08:08:11 INFO - Running setup.py install for psutil 08:08:11 INFO - building 'psutil._psutil_osx' extension 08:08:11 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 08:08:11 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 08:08:11 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 08:08:11 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 08:08:11 INFO - building 'psutil._psutil_posix' extension 08:08:11 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 08:08:11 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 08:08:11 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 08:08:11 INFO - ^ 08:08:11 INFO - 1 warning generated. 08:08:11 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 08:08:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:08:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:08:11 INFO - Successfully installed psutil 08:08:11 INFO - Cleaning up... 08:08:11 INFO - Return code: 0 08:08:11 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:08: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')]} 08:08:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08: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')]} 08:08:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:11 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:11 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 08:08:11 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 08:08:11 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:11 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:11 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:11 INFO - 'HOME': '/Users/cltbld', 08:08:11 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:11 INFO - 'LOGNAME': 'cltbld', 08:08:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:11 INFO - 'MOZ_NO_REMOTE': '1', 08:08:11 INFO - 'NO_EM_RESTART': '1', 08:08:11 INFO - 'PAGER': '/bin/cat', 08:08:11 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:11 INFO - 'PWD': '/builds/slave/test', 08:08:11 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:11 INFO - 'SHELL': '/bin/bash', 08:08:11 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:11 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:11 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:11 INFO - 'USER': 'cltbld', 08:08:11 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:11 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:11 INFO - 'XPC_FLAGS': '0x0', 08:08:11 INFO - 'XPC_SERVICE_NAME': '0', 08:08:11 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:12 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:08:12 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 08:08:12 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 08:08:12 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 08:08:12 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 08:08:12 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 08:08:12 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 08:08:14 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:08:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:08:14 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:08:14 INFO - Installing collected packages: mozsystemmonitor 08:08:14 INFO - Running setup.py install for mozsystemmonitor 08:08:15 INFO - Successfully installed mozsystemmonitor 08:08:15 INFO - Cleaning up... 08:08:15 INFO - Return code: 0 08:08:15 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:08:15 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')]} 08:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:15 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')]} 08:08:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:15 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:15 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 08:08:15 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 08:08:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:15 INFO - 'HOME': '/Users/cltbld', 08:08:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:15 INFO - 'LOGNAME': 'cltbld', 08:08:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:15 INFO - 'MOZ_NO_REMOTE': '1', 08:08:15 INFO - 'NO_EM_RESTART': '1', 08:08:15 INFO - 'PAGER': '/bin/cat', 08:08:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:15 INFO - 'PWD': '/builds/slave/test', 08:08:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:15 INFO - 'SHELL': '/bin/bash', 08:08:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:15 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:15 INFO - 'USER': 'cltbld', 08:08:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:15 INFO - 'XPC_FLAGS': '0x0', 08:08:15 INFO - 'XPC_SERVICE_NAME': '0', 08:08:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:15 INFO - Downloading/unpacking jsonschema==2.5.1 08:08:15 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 08:08:15 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 08:08:15 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 08:08:15 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 08:08:15 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 08:08:15 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 08:08:17 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:08:17 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:08:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:08:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:08:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:08:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:08:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:08:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:08:18 INFO - Downloading functools32-3.2.3-2.tar.gz 08:08:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:08:18 INFO - warning: no files found matching '*.txt' 08:08:18 INFO - no previously-included directories found matching 'build' 08:08:18 INFO - no previously-included directories found matching 'dist' 08:08:18 INFO - no previously-included directories found matching '.git*' 08:08:18 INFO - Installing collected packages: jsonschema, functools32 08:08:18 INFO - Running setup.py install for functools32 08:08:18 INFO - warning: no files found matching '*.txt' 08:08:18 INFO - no previously-included directories found matching 'build' 08:08:18 INFO - no previously-included directories found matching 'dist' 08:08:18 INFO - no previously-included directories found matching '.git*' 08:08:18 INFO - Successfully installed jsonschema functools32 08:08:18 INFO - Cleaning up... 08:08:18 INFO - Return code: 0 08:08:18 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:08:18 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')]} 08:08:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:18 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')]} 08:08:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:18 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:18 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 08:08:18 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 08:08:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:18 INFO - 'HOME': '/Users/cltbld', 08:08:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:18 INFO - 'LOGNAME': 'cltbld', 08:08:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:18 INFO - 'MOZ_NO_REMOTE': '1', 08:08:18 INFO - 'NO_EM_RESTART': '1', 08:08:18 INFO - 'PAGER': '/bin/cat', 08:08:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:18 INFO - 'PWD': '/builds/slave/test', 08:08:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:18 INFO - 'SHELL': '/bin/bash', 08:08:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:18 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:18 INFO - 'USER': 'cltbld', 08:08:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:18 INFO - 'XPC_FLAGS': '0x0', 08:08:18 INFO - 'XPC_SERVICE_NAME': '0', 08:08:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:19 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:08:19 INFO - Cleaning up... 08:08:19 INFO - Return code: 0 08:08:19 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:08:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:19 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:19 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 08:08:19 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 08:08:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:19 INFO - 'HOME': '/Users/cltbld', 08:08:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:19 INFO - 'LOGNAME': 'cltbld', 08:08:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:19 INFO - 'MOZ_NO_REMOTE': '1', 08:08:19 INFO - 'NO_EM_RESTART': '1', 08:08:19 INFO - 'PAGER': '/bin/cat', 08:08:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:19 INFO - 'PWD': '/builds/slave/test', 08:08:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:19 INFO - 'SHELL': '/bin/bash', 08:08:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:19 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:19 INFO - 'USER': 'cltbld', 08:08:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:19 INFO - 'XPC_FLAGS': '0x0', 08:08:19 INFO - 'XPC_SERVICE_NAME': '0', 08:08:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:19 INFO - Downloading/unpacking blobuploader==1.2.4 08:08:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:08:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:08:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:08:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:08:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:08:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:08:21 INFO - Downloading blobuploader-1.2.4.tar.gz 08:08:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:08:22 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:08:22 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 08:08:22 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 08:08:22 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 08:08:22 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 08:08:22 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 08:08:22 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 08:08:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:08:22 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:08:22 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 08:08:22 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 08:08:22 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 08:08:22 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 08:08:22 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 08:08:22 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 08:08:23 INFO - Downloading docopt-0.6.1.tar.gz 08:08:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:08:23 INFO - Installing collected packages: blobuploader, requests, docopt 08:08:23 INFO - Running setup.py install for blobuploader 08:08:23 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:08:23 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:08:23 INFO - Running setup.py install for requests 08:08:23 INFO - Running setup.py install for docopt 08:08:23 INFO - Successfully installed blobuploader requests docopt 08:08:23 INFO - Cleaning up... 08:08:24 INFO - Return code: 0 08:08:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:08: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')]} 08:08:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08: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')]} 08:08:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:24 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:24 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 08:08:24 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 08:08:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:24 INFO - 'HOME': '/Users/cltbld', 08:08:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:24 INFO - 'LOGNAME': 'cltbld', 08:08:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:24 INFO - 'MOZ_NO_REMOTE': '1', 08:08:24 INFO - 'NO_EM_RESTART': '1', 08:08:24 INFO - 'PAGER': '/bin/cat', 08:08:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:24 INFO - 'PWD': '/builds/slave/test', 08:08:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:24 INFO - 'SHELL': '/bin/bash', 08:08:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:24 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:24 INFO - 'USER': 'cltbld', 08:08:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:24 INFO - 'XPC_FLAGS': '0x0', 08:08:24 INFO - 'XPC_SERVICE_NAME': '0', 08:08:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:08:24 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-rHaMMU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:08:24 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-vgxhsV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:08:24 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-kBPyke-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:08:24 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-nkSMOl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:08:24 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-JypPv_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:08:24 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-i7FxDw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:08:24 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-SgeNrG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-eaLZJB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-2N4Tdf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-CFis1z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-gaEGEs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-IvOHmp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-FTGzMm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-4O83qn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-LvGaTF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:08:25 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-GtODKw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:08:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:08:26 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-PxlH6k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:08:26 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:08:26 INFO - Running setup.py install for manifestparser 08:08:26 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:08:26 INFO - Running setup.py install for mozcrash 08:08:26 INFO - Running setup.py install for mozdebug 08:08:26 INFO - Running setup.py install for mozdevice 08:08:26 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:08:26 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:08:26 INFO - Running setup.py install for mozfile 08:08:26 INFO - Running setup.py install for mozhttpd 08:08:27 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:08:27 INFO - Running setup.py install for mozinfo 08:08:27 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:08:27 INFO - Running setup.py install for mozInstall 08:08:27 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:08:27 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:08:27 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:08:27 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:08:27 INFO - Running setup.py install for mozleak 08:08:27 INFO - Running setup.py install for mozlog 08:08:27 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:08:27 INFO - Running setup.py install for moznetwork 08:08:27 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:08:27 INFO - Running setup.py install for mozprocess 08:08:27 INFO - Running setup.py install for mozprofile 08:08:28 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:08:28 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:08:28 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:08:28 INFO - Running setup.py install for mozrunner 08:08:28 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:08:28 INFO - Running setup.py install for mozscreenshot 08:08:28 INFO - Running setup.py install for moztest 08:08:28 INFO - Running setup.py install for mozversion 08:08:28 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:08:28 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:08:28 INFO - Cleaning up... 08:08:28 INFO - Return code: 0 08:08:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:08:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:28 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:28 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 08:08:28 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 08:08:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:28 INFO - 'HOME': '/Users/cltbld', 08:08:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:28 INFO - 'LOGNAME': 'cltbld', 08:08:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:28 INFO - 'MOZ_NO_REMOTE': '1', 08:08:28 INFO - 'NO_EM_RESTART': '1', 08:08:28 INFO - 'PAGER': '/bin/cat', 08:08:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:28 INFO - 'PWD': '/builds/slave/test', 08:08:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:28 INFO - 'SHELL': '/bin/bash', 08:08:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:28 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:28 INFO - 'USER': 'cltbld', 08:08:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:28 INFO - 'XPC_FLAGS': '0x0', 08:08:28 INFO - 'XPC_SERVICE_NAME': '0', 08:08:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-wpWvgr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:08:29 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-RgQGig-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:08:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-JmgGNy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:08:29 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-qIEaS1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:08:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-UiVgy1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:08:29 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-IjBUxT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:08:29 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-At_FpM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:08:29 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-iG3Fju-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:08:29 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-haNuac-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:08:29 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)) 08:08:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:08:29 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-p7qZbd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:08:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 08:08:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:08:30 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-GO4pbO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:08:30 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)) 08:08:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:08:30 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-0GI853-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:08:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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)) 08:08:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:08:30 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-zlfTIL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:08:30 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)) 08:08:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:08:30 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-FuPqhm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:08:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 08:08:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:08:30 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-Rgvzv3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:08:30 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)) 08:08:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:08:30 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-lUfGzC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:08:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 08:08:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:08:30 INFO - Running setup.py (path:/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/pip-N4QIPi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:08:30 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)) 08:08:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:08:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:08:30 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)) 08:08:30 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:08:30 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:08:30 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:08:30 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 08:08:30 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 08:08:30 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 08:08:30 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 08:08:30 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 08:08:30 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 08:08:33 INFO - Downloading blessings-1.6.tar.gz 08:08:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:08:33 INFO - Installing collected packages: blessings 08:08:33 INFO - Running setup.py install for blessings 08:08:33 INFO - Successfully installed blessings 08:08:33 INFO - Cleaning up... 08:08:33 INFO - Return code: 0 08:08:33 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:08:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:08:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:08:34 INFO - Reading from file tmpfile_stdout 08:08:34 INFO - Current package versions: 08:08:34 INFO - blessings == 1.6 08:08:34 INFO - blobuploader == 1.2.4 08:08:34 INFO - docopt == 0.6.1 08:08:34 INFO - functools32 == 3.2.3-2 08:08:34 INFO - jsonschema == 2.5.1 08:08:34 INFO - manifestparser == 1.1 08:08:34 INFO - mozInstall == 1.12 08:08:34 INFO - mozcrash == 1.0 08:08:34 INFO - mozdebug == 0.1 08:08:34 INFO - mozdevice == 0.49 08:08:34 INFO - mozfile == 1.2 08:08:34 INFO - mozhttpd == 0.7 08:08:34 INFO - mozinfo == 0.9 08:08:34 INFO - mozleak == 0.1 08:08:34 INFO - mozlog == 3.4 08:08:34 INFO - moznetwork == 0.27 08:08:34 INFO - mozprocess == 0.24 08:08:34 INFO - mozprofile == 0.28 08:08:34 INFO - mozrunner == 6.13 08:08:34 INFO - mozscreenshot == 0.1 08:08:34 INFO - mozsystemmonitor == 0.3 08:08:34 INFO - moztest == 0.8 08:08:34 INFO - mozversion == 1.4 08:08:34 INFO - psutil == 3.1.1 08:08:34 INFO - requests == 1.2.3 08:08:34 INFO - wsgiref == 0.1.2 08:08:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:08:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:34 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:34 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 08:08:34 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 08:08:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:34 INFO - 'HOME': '/Users/cltbld', 08:08:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:34 INFO - 'LOGNAME': 'cltbld', 08:08:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:34 INFO - 'MOZ_NO_REMOTE': '1', 08:08:34 INFO - 'NO_EM_RESTART': '1', 08:08:34 INFO - 'PAGER': '/bin/cat', 08:08:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:34 INFO - 'PWD': '/builds/slave/test', 08:08:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:34 INFO - 'SHELL': '/bin/bash', 08:08:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:34 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:34 INFO - 'USER': 'cltbld', 08:08:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:34 INFO - 'XPC_FLAGS': '0x0', 08:08:34 INFO - 'XPC_SERVICE_NAME': '0', 08:08:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 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)) 08:08:34 INFO - Cleaning up... 08:08:34 INFO - Return code: 0 08:08:34 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:08:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:08:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:08:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:08:34 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 0x101a06b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101a09768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbfb1c7d820>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, '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.VbCcMtJyln/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.5kW3qGWzlf/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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 08:08:34 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 08:08:34 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 08:08:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:34 INFO - 'HOME': '/Users/cltbld', 08:08:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:34 INFO - 'LOGNAME': 'cltbld', 08:08:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:34 INFO - 'MOZ_NO_REMOTE': '1', 08:08:34 INFO - 'NO_EM_RESTART': '1', 08:08:34 INFO - 'PAGER': '/bin/cat', 08:08:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:34 INFO - 'PWD': '/builds/slave/test', 08:08:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:34 INFO - 'SHELL': '/bin/bash', 08:08:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:34 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:34 INFO - 'USER': 'cltbld', 08:08:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:34 INFO - 'XPC_FLAGS': '0x0', 08:08:34 INFO - 'XPC_SERVICE_NAME': '0', 08:08:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:08:34 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:08:34 INFO - Cleaning up... 08:08:34 INFO - Return code: 0 08:08:34 INFO - Running post-action listener: _resource_record_post_action 08:08:34 INFO - Running post-action listener: _start_resource_monitoring 08:08:34 INFO - Starting resource monitoring. 08:08:34 INFO - [mozharness: 2017-02-14 16:08:34.608250Z] Finished create-virtualenv step (success) 08:08:34 INFO - [mozharness: 2017-02-14 16:08:34.609138Z] Running install step. 08:08:34 INFO - Running pre-action listener: _resource_record_pre_action 08:08:34 INFO - Running main action method: install 08:08:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:08:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:08:34 INFO - Reading from file tmpfile_stdout 08:08:34 INFO - Detecting whether we're running mozinstall >=1.0... 08:08:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:08:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:08:34 INFO - Reading from file tmpfile_stdout 08:08:34 INFO - Output received: 08:08:34 INFO - Usage: mozinstall [options] installer 08:08:34 INFO - Options: 08:08:34 INFO - -h, --help show this help message and exit 08:08:34 INFO - -d DEST, --destination=DEST 08:08:34 INFO - Directory to install application into. [default: 08:08:34 INFO - "/builds/slave/test"] 08:08:34 INFO - --app=APP Application being installed. [default: firefox] 08:08:34 INFO - mkdir: /builds/slave/test/build/application 08:08:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-53.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 08:08:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-53.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 08:08:54 INFO - Reading from file tmpfile_stdout 08:08:54 INFO - Output received: 08:08:54 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 08:08:54 INFO - Running post-action listener: _resource_record_post_action 08:08:54 INFO - [mozharness: 2017-02-14 16:08:54.929668Z] Finished install step (success) 08:08:54 INFO - [mozharness: 2017-02-14 16:08:54.929817Z] Running run-tests step. 08:08:54 INFO - Running pre-action listener: _resource_record_pre_action 08:08:54 INFO - Running main action method: run_tests 08:08:54 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:08:54 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:08:54 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:08:54 INFO - 2017-02-14 08:08:54.944 screenresolution[1950:14665] starting screenresolution argv=screenresolution get 08:08:54 INFO - 2017-02-14 08:08:54.946 screenresolution[1950:14665] Display 0: 1600x1200x32@60 08:08:54 INFO - 2017-02-14 08:08:54.952 screenresolution[1951:14668] starting screenresolution argv=screenresolution list 08:08:54 INFO - Available Modes on Display 0 08:08:54 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:08:54 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:08:54 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:08:54 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:08:55 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:08:55 INFO - Intel Iris: 08:08:55 INFO - Chipset Model: Intel Iris 08:08:55 INFO - Type: GPU 08:08:55 INFO - Bus: Built-In 08:08:55 INFO - VRAM (Dynamic, Max): 1536 MB 08:08:55 INFO - Vendor: Intel (0x8086) 08:08:55 INFO - Device ID: 0x0a2e 08:08:55 INFO - Revision ID: 0x0009 08:08:55 INFO - Displays: 08:08:55 INFO - Display: 08:08:55 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:08:55 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:08:55 INFO - Display Serial Number: 1600x1200 60 08:08:55 INFO - Main Display: Yes 08:08:55 INFO - Mirror: Off 08:08:55 INFO - Online: Yes 08:08:55 INFO - Rotation: Supported 08:08:55 INFO - Return code: 0 08:08:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:08:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:08:55 INFO - Python 2.7.3 08:08:55 INFO - Return code: 0 08:08:55 INFO - grabbing minidump binary from tooltool 08:08:55 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')]} 08:08:55 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 0x1017e4d30>, '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 0x10170bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1017d9be8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:08:55 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 08:08:55 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 08:08:55 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 08:08:55 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:08:55 INFO - Return code: 0 08:08:55 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 08:08:55 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:08:55 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:08:55 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 08:08:55 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:08:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0320', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 08:08:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0320 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 08:08:55 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.VbCcMtJyln/Render', 08:08:55 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:08:55 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:08:55 INFO - 'HOME': '/Users/cltbld', 08:08:55 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:08:55 INFO - 'LOGNAME': 'cltbld', 08:08:55 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:08:55 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 08:08:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:08:55 INFO - 'MOZ_NO_REMOTE': '1', 08:08:55 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:08:55 INFO - 'NO_EM_RESTART': '1', 08:08:55 INFO - 'PAGER': '/bin/cat', 08:08:55 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:08:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:08:55 INFO - 'PWD': '/builds/slave/test', 08:08:55 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:08:55 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:08:55 INFO - 'SHELL': '/bin/bash', 08:08:55 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.5kW3qGWzlf/Listeners', 08:08:55 INFO - 'TMPDIR': '/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/', 08:08:55 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:08:55 INFO - 'USER': 'cltbld', 08:08:55 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:08:55 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:08:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:08:55 INFO - 'XPC_FLAGS': '0x0', 08:08:55 INFO - 'XPC_SERVICE_NAME': '0', 08:08:55 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:08:55 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0320', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 08:08:55 INFO - mozversion application_buildid: 20170214064945 08:08:55 INFO - mozversion application_changeset: a57e10371afcb34942a2df45004348b96f429919 08:08:55 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:08:55 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:08:55 INFO - mozversion application_name: Firefox 08:08:55 INFO - mozversion application_remotingname: firefox-dev 08:08:55 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:08:55 INFO - mozversion application_vendor: Mozilla 08:08:55 INFO - mozversion application_version: 53.0a2 08:08:55 INFO - mozversion platform_buildid: 20170214064945 08:08:55 INFO - mozversion platform_changeset: a57e10371afcb34942a2df45004348b96f429919 08:08:55 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:08:55 INFO - mozversion platform_version: 53.0a2 08:08:55 INFO - using testdate: 1487088535 08:08:55 INFO - actual date: 1487088535 08:08:55 INFO - starting webserver on 'localhost:49678' 08:08:55 INFO - SUITE-START | Running 2 tests 08:08:55 INFO - TEST-START | dromaeo_css 08:08:55 INFO - operating with platform_type : mac_ 08:08:55 INFO - Initialising browser for dromaeo_css test... 08:08:55 INFO - TEST-INFO | started process 1961 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/tmplC7pcQ/profile http://localhost:49678/getInfo.html) 08:08:57 INFO - PROCESS | 1961 | __metrics Screen width/height:1600/1200 08:08:57 INFO - PROCESS | 1961 | colorDepth:24 08:08:57 INFO - PROCESS | 1961 | Browser inner width/height: 1024/689 08:08:57 INFO - PROCESS | 1961 | __metrics 08:08:57 INFO - PROCESS | 1961 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:08:57 INFO - PROCESS | 1961 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:08:58 INFO - TEST-INFO | 1961: exit 0 08:08:58 INFO - Browser initialized. 08:08:58 INFO - Running cycle 1/1 for dromaeo_css test... 08:08:58 INFO - TEST-INFO | started process 1963 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/tmplC7pcQ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:09:10 INFO - PROCESS | 1963 | RSS: Main: 213274624 08:09:10 INFO - PROCESS | 1963 | 08:12:15 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49678/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49678/tests/dromaeo/cssquery-ext.html) 08:12:16 INFO - PROCESS | 1963 | RSS: Main: 340099072 08:12:16 INFO - PROCESS | 1963 | 08:14:00 INFO - PROCESS | 1963 | ************************* 08:14:00 INFO - PROCESS | 1963 | A coding exception was thrown and uncaught in a Task. 08:14:00 INFO - PROCESS | 1963 | 08:14:00 ERROR - PROCESS | 1963 | Full message: TypeError: NetworkError when attempting to fetch resource. 08:14:00 INFO - PROCESS | 1963 | Full stack: 08:14:00 INFO - PROCESS | 1963 | ************************* 08:15:19 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49678/tests/dromaeo/cssquery-ext.html (next: http://localhost:49678/tests/dromaeo/cssquery-jquery.html) 08:15:20 INFO - PROCESS | 1963 | RSS: Main: 350261248 08:15:20 INFO - PROCESS | 1963 | 08:18:22 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49678/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49678/tests/dromaeo/cssquery-mootools.html) 08:18:23 INFO - PROCESS | 1963 | RSS: Main: 324526080 08:18:23 INFO - PROCESS | 1963 | 08:21:25 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49678/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49678/tests/dromaeo/cssquery-prototype.html) 08:21:26 INFO - PROCESS | 1963 | RSS: Main: 317796352 08:21:26 INFO - PROCESS | 1963 | 08:24:29 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49678/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49678/tests/dromaeo/cssquery-yui.html) 08:24:30 INFO - PROCESS | 1963 | RSS: Main: 311537664 08:24:30 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49678/tests/dromaeo/cssquery-yui.html (next: http://localhost:49678/tests/dromaeo/cssquery-dojo.html) 08:27:33 INFO - PROCESS | 1963 | RSS: Main: 440717312 08:27:33 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | __start_tp_report 08:27:33 INFO - PROCESS | 1963 | _x_x_mozilla_page_load 08:27:33 INFO - PROCESS | 1963 | _x_x_mozilla_page_load_details 08:27:33 INFO - PROCESS | 1963 | |i|pagename|runs| 08:27:33 INFO - PROCESS | 1963 | |0;dojo.html;2976.315447447087;3236.7572432067595;3261.885833995812;3281.228911205868;3330.2673411849387;4328.415663885375;5474.616776825624;5477.945220547798;5483.341998960131;5516.889662206759;5402.78388864446;5446.700431476267;5458.181272809081;5458.9454105458935;5467.398586155529;4974.10466116099;4975.303457515951;5053;5059.038782631306;5073.923891141636;4241.978790106061;4909.288153217782;4991.226359914201;4993.151164302078;5110;5031.522005409499;5044.470330615288;5054.9241761373605;5060.342155519777;5133.6919784813035;5043.394792624872;5079.619028572835;5089.821856235051;5096.847094587169;5140.485951404867;5018.698878067327;5046.066477701637;5069.112905241568;5076.6192535559985;5080.110980578384;5294.894102117974;5337.599680024014;5397.865053373697;5410.891782164374;5463.535599474049;4917.311576379309;5924.58527903047;5993.760249590011;6006.699665016732;6024.337322894478;6032.698365081728;6036.275646922353;6063.727132279058;6065.059915713072;6085.300190478108;5411.675299482044;5545.639533430314;5563.304586926634;5568.916466252969;5587.357453892854;4932.605391568666;5844.59087863854;6176.320604733476;6230.252369715572;6254.562180647402;5547.44525547442;5910.822675319747;5914.645121292736;5918.615290006136;5935.465808077208;5988.670623115683;6094.695265236721;6107.6640784757265;6134.171886795315;6136.754529818846;5787.479126878517;5834.591578589458;5839.970800145972;5887.970560147171;6008.459238668541;5008.424031236382;6037.78867739627;6077.817665469955;6083.878322433527;6099.69501524922;4864.416270047617;4867.172580661296;4871.829485968045;4880.194767863334;4896.167651499253;4188.078622703;4237.894052648647;4323.0705398339505;4338.696291259645;4339.7830108494445;5511.0080185566985;5520.66875987442;5559.499645031967;5606;5651.802186923438;5902.468777810018;5998.880022399528;6005.609635373687;6094.481969032593;6129.570930034854;5556.638818476786;5570.359408667974;5570.582206334541;5600.719964001865;5617.494425501724;5185.974070129625;5257.342832145981;5282.841514754564;5322.8935421292135;5323.334583177103;5326.627136100436;6109.43503133753;6114.844865410725;6181.690915454119;6182.598131121643;6124.5712800103565;6143.941779503916;6144.433169541739;6144.539159562962;6144.801763656044;6273.435390814849;6298.370162983665;6303.936960630518;6307.022411526221;6315;5785.305763308262;5872.794452194153;5882.911756323744;6031.487323577545;6034.366391528826;5995.400459954144;6027.849303767441;6033.487153591994;6085.452309292008;6113.510919126548;5663.85840353978;5787.39232380594;5820.330661973758;5831.125331200354;5844.649321040752;5656.773729050792;5714.942850571441;5805.94194058054;5809.62237454581;5816.360200377871;4868.902621947612;5510.6969116698965;5533.059379905506;5549.112142057252;5588.966041282213;5648.322201335866;5649.971750141223;5650.689212093374;5653.067243904874;5667.8866422672145;5019.7741101651245;5515.558755299647;5533.280673512418;5547;5565.916511252415 08:27:33 INFO - PROCESS | 1963 | |1;ext.html;417.78692866638005;469.94595621503515;489.30030057018473;495.7422140486947;507.21888292030275;30743.231419214502;32525;40014.7999260004;42155.57844421555;42264.57735422645;43343;43700.56299437005;43734.906627334334;43784.78107609457;43786.56213437865;9198.586063627135;9435.38669986452;9435.481048542328;9437.669681561147;9451.95274023629;8266.421350505467;8483.618237179342;10957.50691218897;11225.32648041116;11265.211435199539;11231.32612043276;11306.491207895624;11334.773304533905;11346.773064538704;11349.20555561111;8326.292265157468;11282.887171128266;11304.773904521946;11312.660620181408;11325.886741132566;8282.461639993442;8956.014838367775;9129.954350228272;9155.992840787509;9320.673776417862;40386;40587.391189132184;40650.39024414636;40693.18613627711;40745.79627101846;3923.8822835314986;3952.4268980997595;4032.2741906456827;4036.8385264589383;4084;29299.560506592417;29371.41257174866;29396.706032939826;29466.70533294661;30491.695083049108;3087.5677405163296;3174.2857856982223;3351.329734053199;3360.2103505676146;3361.8823341182942;350134;356581;358743;359559;359914;62823;63212.367876321565;63286.36713632897;63361;63413;57523.71238143783;57928.71035644879;65960;66020.66989665022;66159.33840661532;14963.251837408086;15188.848111518964;15411.22943852803;15414.768778468331;15457;10654.73363165927;10935.453227338601;11757.529698811952;11850;11855.703607409883;14603.78094328586;16464;16817.915910420368;16824.15879206035;17247.74128388075;6537.248216455074;6996.440284777205;7015.3686168244085;7084.43324534036;7098.112735908012;853.795089178605;854.2738672128766;864.1833467373272;872.7512658892185;880.6662344786367;24267.514649706907;30020.249493762392;30142.54786178209;30837;30974.53538196929;1054.541274545575;1058.1587637827945;1066.6853278282924;1070.2347821307803;1186.655869797749;15123.092614443169;15435.691286174439;15526.844731552766;15604.141772202638;15787.763183552255;587687;591663.0416847974;593028;593127;596271;61407.38592614106;61533;61605.76788464205;61641.76716465735;61716.382836171964;1419.3045407750335;1429.585420228143;1448.0306782775629;1448.608875603581;1449.5578848451112;28625.856870715514;29296.56055159217;29422.558661620522;29437.85281073581;30003.54994675038;50957;51209.71975700637;51279.487205128964;51361.229581557054;51405.48594514007;504635;509641;509760;510043;510153;24831.25506234816;25547.74452255528;40373.99065023398;40484.3927341096;40887;36327.81836090803;37176.07059823526;42033.73898783042;43816;44056.559434405244;33945.424753594685;36343.454848177826;36510.8174459126;37242;37813;32351;32742;35390.82304588461;35655.82172089123;35970.8201458991;33258;34568.65431345654;35089.298214036084;35133.82433087818;35492.467612986344;31232.063038108892;31923.68076319207;31992.36015279728;32164.221585291038;32473.512897306086;23680.763192368544;23720.169794057125;24078.39804004914;24218;24289.27132186037 08:27:33 INFO - PROCESS | 1963 | |2;jquery.html;393.21945937314433;401.1715806858836;404.9514058313003;407.75127172424817;427.2928303657448;20067.799322006776;20071.698924516106;20760.32090516715;21249.57500849982;21366.145354185832;21152.788472115273;21329.57340853182;21434.57130857382;21910.014049367775;22151.44621384466;5473.233747275394;5624.409437009116;5626.071698169818;5626.774929002855;5748.540116790647;5490.3411590609185;5664.943350566504;5707.971460142693;5734.827955161331;5768.653880767168;5688.516476099537;5690.715464226772;5690.857728556798;5699.772009119631;5709.543236541088;5420.186971954218;5630.127330263816;5678.091505359143;5678.48893599576;5695.686737229451;4956.801727930879;4965.453800081988;4993.550580447777;5050.797968081272;5056.62075344347;25986.350341241432;26324.341891452674;26352.472950540883;26446.471070578482;26634.6004809928;2662.4009597840522;2685.328667833042;2687.9651334236264;2688.4891870544534;2740.2053404512667;14950.551483455514;15390.230488475532;15412.460563880322;15744.448944286894;16086.954347967345;1738.7304967730022;1785.3394244129624;1794.784625844894;1798.3615816385256;1816.4641430777951;126469;129593.32116879508;134896.999999999;135582;135660;11190.776184476428;11308.660740177807;11609.6517104487;11751.706207344714;11783.35191564455;14479.276036198147;14486.203258820655;14499.710005800036;14500;14513.782293265609;6926.341997510229;8047.758567242875;8202.425830191949;8290.37822163328;8361.205685459872;7719.189485104095;7999.4400391972;8019.117897031322;8169;8190.631421586043;6945.131858517685;7040.788776336718;7041.119860017498;7046.224915259318;7061.752838650623;1890.3005887821594;1922.7884932657396;1933.2073849721828;1935.5838494723703;1935.9322423715103;852.3990586636406;856.1310270075878;889.3285569395065;891.8974317953389;900.6667533012827;21016;21123.471913202295;21286.254981075897;21437.785622143892;21598.56802863934;771.7954741993376;897.4166791585391;930.8045310484874;932.8134373125403;938.5870217104452;10840.915908409095;11349.205555611194;11435.656930292105;11582.420878956018;11625.88374116248;736146;737892;742445;746360;757000;163170;164996.17501912414;165115.1744241295;166303;172667;1009.3338396658318;1045.900639439252;1047.4448542272455;1068.3963560588243;1068.8824229334923;18956.336528221447;19452;19748.40754777359;19884.90057549703;19896.50258743543;61026.38973610385;61432.692836535534;63109.68445157745;64090;64225.71548568909;89661;90162;93281;93893;94309;8104.554249516334;8122.147174546824;8157.8368432632205;8602.268807151462;8658.870116948125;9333.85999210026;12669.176503527242;12854.871451285368;13353.66615834612;13365.53220637273;9047.68333108338;9189.356745028052;10989;11240.988311052044;11249.550017999189;10972.780544389227;11144.777104458028;11200;11381.317120972768;11544;11371.20401571882;11404.087672986307;11465.656030319104;11687.675560042839;11820.70448238801;6277.435030847246;7583.620818959141;8322.292605128632;8550.657973680984;8587.9694436668;5654.378018418053;6890.724371025303;9270.119338662817;11023.283486573348;11555.133364997828 08:27:33 INFO - PROCESS | 1963 | |3;mootools.html;1307.960761177165;1423.2243427332103;1430.449277028344;1447.2618964328192;1448.0659974316566;7477.364424023957;7851.803704907373;8088.393370497207;8418.536980466071;8429.325653947684;8325.542095184777;8345.91654083459;8375.288100511463;8466.941632295962;8488.108748581402;1994.2621230144866;2036.297477370305;2119.9364019079453;2289.679444877714;2340.648902664597;2285.074544809355;2371.95256094878;2372.3120295114395;2386.486905315357;2389.5579317826173;2305.7578954209816;2335.6262997920335;2343.6367363058753;2349.530093981202;2350.9412264693347;2043.1827269092332;2123.980489365098;2326.988365058181;2344.0623750499853;2362.6692263083182;2107.525806693497;2231.5090680050525;2307.976920230793;2312.09828167015;2317.88410579472;8455.577221138918;8488.74533763988;8504.064552899175;8505.149485051506;8514.446560973578;4967.180415231483;5142.280080788692;5149.613778966555;5152.793888244466;5157.123289040872;3351.798892066484;3457.3949558827103;3482.6169121396624;3521.084518025332;3545.0251180925193;1174.5360582569838;1200.9459574319176;1207.9456424460832;1247.6756043428684;1276.183242724657;10847.945760271226;10907.67276981684;11019.504122314514;11032.669019929415;11037.11703063745;4549.3176023596725;4634.652401069866;4692.671512994126;4729.456112547101;4784.784684689197;9581.616735330648;9587.137157655845;9588.185004274716;9621.941586425488;9624.03759624046;5272.182811664198;5297.470252974672;5300.655457395257;5301.0723123453245;5312.814051508179;4646.605038571692;4743.146233677971;4744;4818.807247710052;4836.733979631154;3875.5349358076646;3884.1454879926373;3932.2528719543197;3973.0663294125857;3995.34193309779;1274.4838340472124;1274.9490020399267;1278;1292.0438875232448;1293.6442478318538;767.8042099264652;767.9347255483235;795.9403044771665;797.3023604346197;802.6388125343618;5404.486573775485;5408.621396502286;5423.311909862781;5535.557155427556;5573.637713548606;555.3696554410773;558.132104577386;558.2240685447232;563.892860356531;571.8313097636208;3559.715222782171;3598.2623562169692;3606.2246616977477;3613.2954073955852;3669.3028324618235;9644.855327170098;10049.397036177852;10058.245631577662;10175.236857235737;10234.385936843813;9910;10020.148287395506;10024.248181386425;10037.297389182688;10055.798884022279;7615.504992175491;7750;7764.61176941162;7768.533887966627;7878.212178782191;5185.351831021122;5246.711430871186;5372.838814835562;5431.293931788842;5526.032944234663;9275;9392.96677365503;9418.293627978066;9422.115576884788;9461.38500997433;9031.50326732036;9258.305627077862;9396.624135034795;9459.527023648927;9472.810543789223;6898.896516552356;7084.079069720903;7148.606826624377;7204.603746793767;7206.315400036988;6699.598024118569;7633.961830190813;7683.231676832272;7845.0585929688805;7855.057393112863;6943.722251110101;6944.756933507505;6988.9301106990315;7024.1571011478945;7159.749408770668;6154.692265386802;6821.386075253251;6825.2833452486775;6946.201186863374;7001.614911179934;6279.120923070683;6452;6468.256150542559;6473.061406096184;6478.384553467413;4809.350737650372;4832.782524786463;4905.558499735041;4933.963867587847;5017.046761115376;4188.476440444944;4872.123017856819;4940.802367905388;4963.230699241623;5080.26336181259 08:27:33 INFO - PROCESS | 1963 | |4;prototype.html;283.9943201135977;340.6746557038027;358.7022771099987;363.94456077375617;373.7888093227328;5162.638615296931;5179.3067604845555;5286.524212820846;5348.117560602501;5349.518543331104;4581.9083618327695;5205.141151709963;5231.947680523193;5255.658382205154;5283.867903302419;3442.776219545734;3870.767753934766;3983.9442547724875;3989.820458079379;4007.5992400759983;3778.394182472452;3882.1365744442683;4090.5909409059154;4101.8974525636795;4109.28087584673;3892.4939757831585;4135.58644135587;4155.709100362976;4158.625723684868;4174.624283814456;3499.5800503939563;3704.814759262053;3929.960700392988;4165.958510372392;4197.91604167918;2945.587617733519;3582.301451217014;3610.4403817408343;3669.1377526281303;3694.1688120173017;4294.570542945712;4320.891977700551;5062.265971434158;5068.366454193226;5077.644564880423;4673.88315292117;4695.3661255730385;4716.363290955712;4759.833405830779;4772.093302272557;4251.447311849471;4444.244568367601;5357.651752636066;5546.084895992197;5670.262865827457;4053.8175782089875;4056.776877271749;4058.3303754880408;4070.432883339906;4079.0618157823865;4641.837535686234;4926.433460152092;5638.4925356718095;5700.543956483471;5820.1269809528485;3950.7234493585174;3997.540282867449;4117.629413352813;4120.25835349634;4124.8556300529335;3407.0460271124125;3665.9450108248398;4194.895127621834;4195.7692326922315;4210.2842516772225;3832.3676593362343;4624.653151013687;4718.457377401574;4751.59611433032;4770.928436073462;5319.547838433699;5579.832605021856;5600.327960644749;5618.073017952074;5675.432456754292;1215.3497878634887;1217.8004665404746;1337.2979185927466;1349.7840345544666;1390.728807882453;811.4522697179381;850.268768858781;968.7384406210284;973.6932866147141;980.7989362180735;4232.851850185229;4561.585908368416;4910.729909854992;5003.4746351633285;5112.90072634378;4319.594014105594;4944.121233931083;5394.1929453633475;5463.562914966793;5617.623682197806;4632.2438149301115;4741.739204343794;4777.737224452689;4893.804247830119;4962.982588569334;2515.4340273438697;2816.8873245070376;2827.6182715333166;2831.0940499040107;2844.5164322065298;4873.31773551703;4909.93782611297;5182.818601348935;5566.886622675481;5637.8590535236945;4566.360709500673;4957.405111386584;4996;5211.8175863845345;5548.278723765965;4911.901761964741;5265.420803711665;5595.972020139873;5606.831795046155;5634.492895639412;5272.9736351318;5392.811251606175;5421.756020978986;5457.20870473787;5461.399246082849;4513.796879140381;4929.806236224846;5623.578231632562;5637.57718171147;5697.800576979952;4570.131674981876;5582.995060889079;5586.40787375596;5642.153676948491;5926.525877929842;3790.0102446214855;3802.2775672622115;3812.5424949006297;3816.9121800286784;3830.712696547826;5442.972785136049;5621.662700237835;5641.717914104361;5667.631603945731;5672.886542269214;5368.758405871667;5476.616636835383;5498.010358135414;5506.366767821752;5518.668879867221;5089.7709603067215;5103.362079740033;5313.256144139901;5481.945180548143;5564.415736347787;4547.749873756975;4740.454847692422;4879.804807807648;5365.517103460707;5433.782648694008;5450.8909821802545;5479.3972663007835;5480.972595136999;5514.91727624094;5516.641418307797;5388.703621300866;5406.2701535292235;5441.2654291670115;5463.235147079333;5466.808661696821 08:27:33 INFO - PROCESS | 1963 | |5;yui.html;702.094298355122;760.7261385901074;811.5495899775624;819.1112642782581;821.3593397150217;12857.421416036277;13115;13319.334033298344;13336.33318334083;13416.798748018775;14355.354009069591;14408.135511869295;14414.135151890894;14447.566573002827;14453.92773036136;654.1790053482872;674.2684187656399;678.5589366911497;679.7484930575694;841.9368547358941;683.1801837794666;683.3849535418138;829.3365307753803;853.1766844994579;857.2413414128509;905.2622112977901;907.6550910653942;908.4503875155535;908.5502676175303;915.6566287642135;764.3273918951343;884.8938127424686;909.3316412436886;909.7725568607848;911.8996910339857;674.8549061951655;677.2448719677574;677.7153595489906;677.7153595489906;679.8198477403492;12056.6383008509;12565.120441569003;14668.193249371281;15165.848341516665;15267.236638168159;13149.605511834565;14458.49395271171;14568.271586420637;14643.56069317922;14708.117512949257;11053.447327633667;11542.653720388402;11809.40952952349;11882.643520694393;11990.520379184909;3516.6307537708685;3620.11730937227;3653.561572611277;3688.6495782900583;3735.2435586864217;101928;104080.47959760153;106041.46979265055;107948.92051079468;107953.46023269912;10077.193824494023;10613.416262105504;10771.892281077246;10843.78312433747;11148.163887708455;21476;21614.35156945294;21819.345419637437;21970.231041913456;21984.120635174735;6580.736770529221;7497.212792656802;7598.886016709644;7716.189800070912;7807.9849619549095;4262.616364527207;4268.277512675975;4285.228658841438;4290.635295999812;4330.2638551446325;3548.7870727756417;3593.191531905353;3612.476190952297;3633.3096711624707;3665.211979424383;659.3966520633662;662.4998126414526;666.3736088077192;667.7796327212009;677.3429773120066;657.8750037492861;673.4881490067584;681.4173881331391;700.1318365227082;716.1477841368859;9652.710418687451;9713.514324283757;9906;9989.523908823321;10050.261209735267;655.2824657000576;680.3433639088736;689.2969171445199;711.1466240511407;713.8500914807948;4560.977195114069;4965.528274813887;4986.975065124651;4997.750112494361;5005.424376196711;104780;105699.47150264353;106214.46892765642;106360;107746;66540;99865;100201;100900;102709;81089;81353.59323203465;81636.59181704173;81686.18875008676;84092;9475.620975161191;9712.02879712023;9718.271129665161;9729.978352273192;9803.509824508888;39674.60325396709;47286.81782955454;48298;49118.508814911394;50266;62825.371746281955;62921;64029.67985160044;64667.67666161827;65719.34280657323;11336.489857956247;11461.598844040418;11495.942520287344;11564.595239166589;11761.353125577833;12144.635660930186;12324.753504930031;12348.691282718004;12394.62816115518;12400.441980110736;11756.764864702487;11834.704132396759;11883.405829708307;11908.76182476363;11936.880631193924;11530.654080377602;11736.354500502553;11877.643670689893;11939.82090268664;12013.79022563103;10356.741081472723;11361.147913906656;12406.317652529198;13283.800742989057;13332.200067995951;10658.786824263627;10759.515821788194;10963.780724385628;11237.55049797999;11370.488328025092;10451.21615878797;10650.64504681023;10763.408012559385;10783;10816.459177041274 08:27:33 INFO - PROCESS | 1963 | __end_tp_report 08:27:33 INFO - PROCESS | 1963 | __start_cc_report 08:27:33 INFO - PROCESS | 1963 | _x_x_mozilla_cycle_collect,1417 08:27:33 INFO - PROCESS | 1963 | __end_cc_report 08:27:33 INFO - PROCESS | 1963 | __startTimestamp1487089653265__endTimestamp 08:27:33 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | ------- Summary: start ------- 08:27:33 INFO - PROCESS | 1963 | Number of tests: 6 08:27:33 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | [#0] dojo.html Cycles:165 Average:5496.24 Median:5570.36 stddev:633.60 (11.4%) stddev-sans-first:603.92 08:27:33 INFO - PROCESS | 1963 | Values: 2976.3 3236.8 3261.9 3281.2 3330.3 4328.4 5474.6 5477.9 5483.3 5516.9 5402.8 5446.7 5458.2 5458.9 5467.4 4974.1 4975.3 5053.0 5059.0 5073.9 4242.0 4909.3 4991.2 4993.2 5110.0 5031.5 5044.5 5054.9 5060.3 5133.7 5043.4 5079.6 5089.8 5096.8 5140.5 5018.7 5046.1 5069.1 5076.6 5080.1 5294.9 5337.6 5397.9 5410.9 5463.5 4917.3 5924.6 5993.8 6006.7 6024.3 6032.7 6036.3 6063.7 6065.1 6085.3 5411.7 5545.6 5563.3 5568.9 5587.4 4932.6 5844.6 6176.3 6230.3 6254.6 5547.4 5910.8 5914.6 5918.6 5935.5 5988.7 6094.7 6107.7 6134.2 6136.8 5787.5 5834.6 5840.0 5888.0 6008.5 5008.4 6037.8 6077.8 6083.9 6099.7 4864.4 4867.2 4871.8 4880.2 4896.2 4188.1 4237.9 4323.1 4338.7 4339.8 5511.0 5520.7 5559.5 5606.0 5651.8 5902.5 5998.9 6005.6 6094.5 6129.6 5556.6 5570.4 5570.6 5600.7 5617.5 5186.0 5257.3 5282.8 5322.9 5323.3 5326.6 6109.4 6114.8 6181.7 6182.6 6124.6 6143.9 6144.4 6144.5 6144.8 6273.4 6298.4 6303.9 6307.0 6315.0 5785.3 5872.8 5882.9 6031.5 6034.4 5995.4 6027.8 6033.5 6085.5 6113.5 5663.9 5787.4 5820.3 5831.1 5844.6 5656.8 5714.9 5805.9 5809.6 5816.4 4868.9 5510.7 5533.1 5549.1 5589.0 5648.3 5650.0 5650.7 5653.1 5667.9 5019.8 5515.6 5533.3 5547.0 5565.9 08:27:33 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | [#1] ext.html Cycles:180 Average:63073.38 Median:197942.41 stddev:132203.44 (66.8%) stddev-sans-first:132490.60 08:27:33 INFO - PROCESS | 1963 | Values: 417.8 469.9 489.3 495.7 507.2 30743.2 32525.0 40014.8 42155.6 42264.6 43343.0 43700.6 43734.9 43784.8 43786.6 9198.6 9435.4 9435.5 9437.7 9452.0 8266.4 8483.6 10957.5 11225.3 11265.2 11231.3 11306.5 11334.8 11346.8 11349.2 8326.3 11282.9 11304.8 11312.7 11325.9 8282.5 8956.0 9130.0 9156.0 9320.7 40386.0 40587.4 40650.4 40693.2 40745.8 3923.9 3952.4 4032.3 4036.8 4084.0 29299.6 29371.4 29396.7 29466.7 30491.7 3087.6 3174.3 3351.3 3360.2 3361.9 350134.0 356581.0 358743.0 359559.0 359914.0 62823.0 63212.4 63286.4 63361.0 63413.0 57523.7 57928.7 65960.0 66020.7 66159.3 14963.3 15188.8 15411.2 15414.8 15457.0 10654.7 10935.5 11757.5 11850.0 11855.7 14603.8 16464.0 16817.9 16824.2 17247.7 6537.2 6996.4 7015.4 7084.4 7098.1 853.8 854.3 864.2 872.8 880.7 24267.5 30020.2 30142.5 30837.0 30974.5 1054.5 1058.2 1066.7 1070.2 1186.7 15123.1 15435.7 15526.8 15604.1 15787.8 587687.0 591663.0 593028.0 593127.0 596271.0 61407.4 61533.0 61605.8 61641.8 61716.4 1419.3 1429.6 1448.0 1448.6 1449.6 28625.9 29296.6 29422.6 29437.9 30003.5 50957.0 51209.7 51279.5 51361.2 51405.5 504635.0 509641.0 509760.0 510043.0 510153.0 24831.3 25547.7 40374.0 40484.4 40887.0 36327.8 37176.1 42033.7 43816.0 44056.6 33945.4 36343.5 36510.8 37242.0 37813.0 32351.0 32742.0 35390.8 35655.8 35970.8 33258.0 34568.7 35089.3 35133.8 35492.5 31232.1 31923.7 31992.4 32164.2 32473.5 23680.8 23720.2 24078.4 24218.0 24289.3 08:27:33 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | [#2] jquery.html Cycles:180 Average:41419.98 Median:2686.65 stddev:124368.51 (4629.1%) stddev-sans-first:124679.24 08:27:33 INFO - PROCESS | 1963 | Values: 393.2 401.2 405.0 407.8 427.3 20067.8 20071.7 20760.3 21249.6 21366.1 21152.8 21329.6 21434.6 21910.0 22151.4 5473.2 5624.4 5626.1 5626.8 5748.5 5490.3 5664.9 5708.0 5734.8 5768.7 5688.5 5690.7 5690.9 5699.8 5709.5 5420.2 5630.1 5678.1 5678.5 5695.7 4956.8 4965.5 4993.6 5050.8 5056.6 25986.4 26324.3 26352.5 26446.5 26634.6 2662.4 2685.3 2688.0 2688.5 2740.2 14950.6 15390.2 15412.5 15744.4 16087.0 1738.7 1785.3 1794.8 1798.4 1816.5 126469.0 129593.3 134897.0 135582.0 135660.0 11190.8 11308.7 11609.7 11751.7 11783.4 14479.3 14486.2 14499.7 14500.0 14513.8 6926.3 8047.8 8202.4 8290.4 8361.2 7719.2 7999.4 8019.1 8169.0 8190.6 6945.1 7040.8 7041.1 7046.2 7061.8 1890.3 1922.8 1933.2 1935.6 1935.9 852.4 856.1 889.3 891.9 900.7 21016.0 21123.5 21286.3 21437.8 21598.6 771.8 897.4 930.8 932.8 938.6 10840.9 11349.2 11435.7 11582.4 11625.9 736146.0 737892.0 742445.0 746360.0 757000.0 163170.0 164996.2 165115.2 166303.0 172667.0 1009.3 1045.9 1047.4 1068.4 1068.9 18956.3 19452.0 19748.4 19884.9 19896.5 61026.4 61432.7 63109.7 64090.0 64225.7 89661.0 90162.0 93281.0 93893.0 94309.0 8104.6 8122.1 8157.8 8602.3 8658.9 9333.9 12669.2 12854.9 13353.7 13365.5 9047.7 9189.4 10989.0 11241.0 11249.6 10972.8 11144.8 11200.0 11381.3 11544.0 11371.2 11404.1 11465.7 11687.7 11820.7 6277.4 7583.6 8322.3 8550.7 8588.0 5654.4 6890.7 9270.1 11023.3 11555.1 08:27:33 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | [#3] mootools.html Cycles:180 Average:5413.30 Median:5151.20 stddev:3000.62 (58.3%) stddev-sans-first:2993.17 08:27:33 INFO - PROCESS | 1963 | Values: 1308.0 1423.2 1430.4 1447.3 1448.1 7477.4 7851.8 8088.4 8418.5 8429.3 8325.5 8345.9 8375.3 8466.9 8488.1 1994.3 2036.3 2119.9 2289.7 2340.6 2285.1 2372.0 2372.3 2386.5 2389.6 2305.8 2335.6 2343.6 2349.5 2350.9 2043.2 2124.0 2327.0 2344.1 2362.7 2107.5 2231.5 2308.0 2312.1 2317.9 8455.6 8488.7 8504.1 8505.1 8514.4 4967.2 5142.3 5149.6 5152.8 5157.1 3351.8 3457.4 3482.6 3521.1 3545.0 1174.5 1200.9 1207.9 1247.7 1276.2 10847.9 10907.7 11019.5 11032.7 11037.1 4549.3 4634.7 4692.7 4729.5 4784.8 9581.6 9587.1 9588.2 9621.9 9624.0 5272.2 5297.5 5300.7 5301.1 5312.8 4646.6 4743.1 4744.0 4818.8 4836.7 3875.5 3884.1 3932.3 3973.1 3995.3 1274.5 1274.9 1278.0 1292.0 1293.6 767.8 767.9 795.9 797.3 802.6 5404.5 5408.6 5423.3 5535.6 5573.6 555.4 558.1 558.2 563.9 571.8 3559.7 3598.3 3606.2 3613.3 3669.3 9644.9 10049.4 10058.2 10175.2 10234.4 9910.0 10020.1 10024.2 10037.3 10055.8 7615.5 7750.0 7764.6 7768.5 7878.2 5185.4 5246.7 5372.8 5431.3 5526.0 9275.0 9393.0 9418.3 9422.1 9461.4 9031.5 9258.3 9396.6 9459.5 9472.8 6898.9 7084.1 7148.6 7204.6 7206.3 6699.6 7634.0 7683.2 7845.1 7855.1 6943.7 6944.8 6988.9 7024.2 7159.7 6154.7 6821.4 6825.3 6946.2 7001.6 6279.1 6452.0 6468.3 6473.1 6478.4 4809.4 4832.8 4905.6 4934.0 5017.0 4188.5 4872.1 4940.8 4963.2 5080.3 08:27:33 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | [#4] prototype.html Cycles:180 Average:4438.29 Median:4910.33 stddev:1314.34 (26.8%) stddev-sans-first:1280.51 08:27:33 INFO - PROCESS | 1963 | Values: 284.0 340.7 358.7 363.9 373.8 5162.6 5179.3 5286.5 5348.1 5349.5 4581.9 5205.1 5231.9 5255.7 5283.9 3442.8 3870.8 3983.9 3989.8 4007.6 3778.4 3882.1 4090.6 4101.9 4109.3 3892.5 4135.6 4155.7 4158.6 4174.6 3499.6 3704.8 3930.0 4166.0 4197.9 2945.6 3582.3 3610.4 3669.1 3694.2 4294.6 4320.9 5062.3 5068.4 5077.6 4673.9 4695.4 4716.4 4759.8 4772.1 4251.4 4444.2 5357.7 5546.1 5670.3 4053.8 4056.8 4058.3 4070.4 4079.1 4641.8 4926.4 5638.5 5700.5 5820.1 3950.7 3997.5 4117.6 4120.3 4124.9 3407.0 3665.9 4194.9 4195.8 4210.3 3832.4 4624.7 4718.5 4751.6 4770.9 5319.5 5579.8 5600.3 5618.1 5675.4 1215.3 1217.8 1337.3 1349.8 1390.7 811.5 850.3 968.7 973.7 980.8 4232.9 4561.6 4910.7 5003.5 5112.9 4319.6 4944.1 5394.2 5463.6 5617.6 4632.2 4741.7 4777.7 4893.8 4963.0 2515.4 2816.9 2827.6 2831.1 2844.5 4873.3 4909.9 5182.8 5566.9 5637.9 4566.4 4957.4 4996.0 5211.8 5548.3 4911.9 5265.4 5596.0 5606.8 5634.5 5273.0 5392.8 5421.8 5457.2 5461.4 4513.8 4929.8 5623.6 5637.6 5697.8 4570.1 5583.0 5586.4 5642.2 5926.5 3790.0 3802.3 3812.5 3816.9 3830.7 5443.0 5621.7 5641.7 5667.6 5672.9 5368.8 5476.6 5498.0 5506.4 5518.7 5089.8 5103.4 5313.3 5481.9 5564.4 4547.7 4740.5 4879.8 5365.5 5433.8 5450.9 5479.4 5481.0 5514.9 5516.6 5388.7 5406.3 5441.3 5463.2 5466.8 08:27:33 INFO - PROCESS | 1963 | 08:27:33 INFO - PROCESS | 1963 | [#5] yui.html Cycles:180 Average:20286.11 Median:3659.39 stddev:30112.15 (822.9%) stddev-sans-first:30160.72 08:27:33 INFO - PROCESS | 1963 | Values: 702.1 760.7 811.5 819.1 821.4 12857.4 13115.0 13319.3 13336.3 13416.8 14355.4 14408.1 14414.1 14447.6 14453.9 654.2 674.3 678.6 679.7 841.9 683.2 683.4 829.3 853.2 857.2 905.3 907.7 908.5 908.6 915.7 764.3 884.9 909.3 909.8 911.9 674.9 677.2 677.7 677.7 679.8 12056.6 12565.1 14668.2 15165.8 15267.2 13149.6 14458.5 14568.3 14643.6 14708.1 11053.4 11542.7 11809.4 11882.6 11990.5 3516.6 3620.1 3653.6 3688.6 3735.2 101928.0 104080.5 106041.5 107948.9 107953.5 10077.2 10613.4 10771.9 10843.8 11148.2 21476.0 21614.4 21819.3 21970.2 21984.1 6580.7 7497.2 7598.9 7716.2 7808.0 4262.6 4268.3 4285.2 4290.6 4330.3 3548.8 3593.2 3612.5 3633.3 3665.2 659.4 662.5 666.4 667.8 677.3 657.9 673.5 681.4 700.1 716.1 9652.7 9713.5 9906.0 9989.5 10050.3 655.3 680.3 689.3 711.1 713.9 4561.0 4965.5 4987.0 4997.8 5005.4 104780.0 105699.5 106214.5 106360.0 107746.0 66540.0 99865.0 100201.0 100900.0 102709.0 81089.0 81353.6 81636.6 81686.2 84092.0 9475.6 9712.0 9718.3 9730.0 9803.5 39674.6 47286.8 48298.0 49118.5 50266.0 62825.4 62921.0 64029.7 64667.7 65719.3 11336.5 11461.6 11495.9 11564.6 11761.4 12144.6 12324.8 12348.7 12394.6 12400.4 11756.8 11834.7 11883.4 11908.8 11936.9 11530.7 11736.4 11877.6 11939.8 12013.8 10356.7 11361.1 12406.3 13283.8 13332.2 10658.8 10759.5 10963.8 11237.6 11370.5 10451.2 10650.6 10763.4 10783.0 10816.5 08:27:33 INFO - PROCESS | 1963 | -------- Summary: end -------- 08:27:33 INFO - PROCESS | 1963 | 08:27:34 INFO - TEST-INFO | 1963: exit 0 08:27:34 INFO - TEST-OK | dromaeo_css | took 1118487ms 08:27:34 INFO - TEST-START | kraken 08:27:34 INFO - operating with platform_type : mac_ 08:27:34 INFO - Initialising browser for kraken test... 08:27:34 INFO - TEST-INFO | started process 1967 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/tmp1YYzfF/profile http://localhost:49678/getInfo.html) 08:27:36 INFO - PROCESS | 1967 | __metrics Screen width/height:1600/1200 08:27:36 INFO - PROCESS | 1967 | colorDepth:24 08:27:36 INFO - PROCESS | 1967 | Browser inner width/height: 1024/689 08:27:36 INFO - PROCESS | 1967 | __metrics 08:27:36 INFO - PROCESS | 1967 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:27:36 INFO - PROCESS | 1967 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:27:37 INFO - TEST-INFO | 1967: exit 0 08:27:37 INFO - Browser initialized. 08:27:37 INFO - Running cycle 1/1 for kraken test... 08:27:37 INFO - TEST-INFO | started process 1968 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/T/tmp1YYzfF/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:27:49 INFO - PROCESS | 1968 | RSS: Main: 213630976 08:27:49 INFO - PROCESS | 1968 | 08:27:52 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49678/tests/kraken/driver.html?testName=audio-beat-detection) 08:27:52 INFO - PROCESS | 1968 | RSS: Main: 268156928 08:27:52 INFO - PROCESS | 1968 | 08:27:55 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49678/tests/kraken/driver.html?testName=audio-dft) 08:27:56 INFO - PROCESS | 1968 | RSS: Main: 278020096 08:27:56 INFO - PROCESS | 1968 | 08:27:59 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49678/tests/kraken/driver.html?testName=audio-fft) 08:27:59 INFO - PROCESS | 1968 | RSS: Main: 373817344 08:27:59 INFO - PROCESS | 1968 | 08:28:01 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49678/tests/kraken/driver.html?testName=audio-oscillator) 08:28:02 INFO - PROCESS | 1968 | RSS: Main: 276889600 08:28:02 INFO - PROCESS | 1968 | 08:28:04 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49678/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:28:05 INFO - PROCESS | 1968 | RSS: Main: 278765568 08:28:05 INFO - PROCESS | 1968 | 08:28:08 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49678/tests/kraken/driver.html?testName=imaging-darkroom) 08:28:08 INFO - PROCESS | 1968 | RSS: Main: 320516096 08:28:08 INFO - PROCESS | 1968 | 08:28:11 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49678/tests/kraken/driver.html?testName=imaging-desaturate) 08:28:12 INFO - PROCESS | 1968 | RSS: Main: 318996480 08:28:12 INFO - PROCESS | 1968 | 08:28:15 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49678/tests/kraken/driver.html?testName=json-parse-financial) 08:28:15 INFO - PROCESS | 1968 | RSS: Main: 314990592 08:28:15 INFO - PROCESS | 1968 | 08:28:17 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49678/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:28:18 INFO - PROCESS | 1968 | RSS: Main: 295452672 08:28:18 INFO - PROCESS | 1968 | 08:28:19 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49678/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:28:20 INFO - PROCESS | 1968 | RSS: Main: 297959424 08:28:20 INFO - PROCESS | 1968 | 08:28:22 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49678/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:28:23 INFO - PROCESS | 1968 | RSS: Main: 301125632 08:28:23 INFO - PROCESS | 1968 | 08:28:26 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49678/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:28:27 INFO - PROCESS | 1968 | RSS: Main: 319393792 08:28:27 INFO - PROCESS | 1968 | 08:28:29 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49678/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:28:30 INFO - PROCESS | 1968 | RSS: Main: 312393728 08:28:30 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | Cycle 1(1): loaded http://localhost:49678/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49678/tests/kraken/driver.html?testName=ai-astar) 08:28:32 INFO - PROCESS | 1968 | RSS: Main: 357388288 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | __start_tp_report 08:28:32 INFO - PROCESS | 1968 | _x_x_mozilla_page_load 08:28:32 INFO - PROCESS | 1968 | _x_x_mozilla_page_load_details 08:28:32 INFO - PROCESS | 1968 | |i|pagename|runs| 08:28:32 INFO - PROCESS | 1968 | |0;ai-astar;117;114;115;122;166;152;114;115;115;115 08:28:32 INFO - PROCESS | 1968 | |1;audio-beat-detection;141;109;110;142;111;139;138;110;130;111 08:28:32 INFO - PROCESS | 1968 | |2;audio-dft;186;184;185;186;182;184;187;186;185;183 08:28:32 INFO - PROCESS | 1968 | |3;audio-fft;76;59;60;91;60;59;57;58;73;58 08:28:32 INFO - PROCESS | 1968 | |4;audio-oscillator;88;70;86;70;68;70;83;70;71;103 08:28:32 INFO - PROCESS | 1968 | |5;imaging-gaussian-blur;94;131;136;86;89;86;89;87;89;85 08:28:32 INFO - PROCESS | 1968 | |6;imaging-darkroom;109;149;151;95;95;95;96;95;94;95 08:28:32 INFO - PROCESS | 1968 | |7;imaging-desaturate;88;85;85;88;86;81;86;83;86;85 08:28:32 INFO - PROCESS | 1968 | |8;json-parse-financial;57;54;52;53;55;56;56;56;57;56 08:28:32 INFO - PROCESS | 1968 | |9;json-stringify-tinderbox;65;73;75;75;74;70;71;72;71;70 08:28:32 INFO - PROCESS | 1968 | |10;stanford-crypto-aes;84;83;82;83;85;85;82;83;84;84 08:28:32 INFO - PROCESS | 1968 | |11;stanford-crypto-ccm;139;140;136;138;137;137;139;145;212;154 08:28:32 INFO - PROCESS | 1968 | |12;stanford-crypto-pbkdf2;170;170;168;170;170;167;175;166;152;210 08:28:32 INFO - PROCESS | 1968 | |13;stanford-crypto-sha256-iterative;68;69;80;83;80;66;66;65;65;65 08:28:32 INFO - PROCESS | 1968 | __end_tp_report 08:28:32 INFO - PROCESS | 1968 | __start_cc_report 08:28:32 INFO - PROCESS | 1968 | _x_x_mozilla_cycle_collect,2092 08:28:32 INFO - PROCESS | 1968 | __end_cc_report 08:28:32 INFO - PROCESS | 1968 | __startTimestamp1487089712657__endTimestamp 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | ------- Summary: start ------- 08:28:32 INFO - PROCESS | 1968 | Number of tests: 14 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#0] ai-astar Cycles:10 Average:124.50 Median:116.00 stddev:18.63 (16.1%) stddev-sans-first:19.56 08:28:32 INFO - PROCESS | 1968 | Values: 117.0 114.0 115.0 122.0 166.0 152.0 114.0 115.0 115.0 115.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#1] audio-beat-detection Cycles:10 Average:124.10 Median:134.00 stddev:15.00 (11.2%) stddev-sans-first:14.61 08:28:32 INFO - PROCESS | 1968 | Values: 141.0 109.0 110.0 142.0 111.0 139.0 138.0 110.0 130.0 111.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#2] audio-dft Cycles:10 Average:184.80 Median:185.50 stddev:1.55 (0.8%) stddev-sans-first:1.58 08:28:32 INFO - PROCESS | 1968 | Values: 186.0 184.0 185.0 186.0 182.0 184.0 187.0 186.0 185.0 183.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#3] audio-fft Cycles:10 Average:65.10 Median:60.00 stddev:11.28 (18.8%) stddev-sans-first:11.25 08:28:32 INFO - PROCESS | 1968 | Values: 76.0 59.0 60.0 91.0 60.0 59.0 57.0 58.0 73.0 58.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#4] audio-oscillator Cycles:10 Average:77.90 Median:70.50 stddev:11.64 (16.5%) stddev-sans-first:11.76 08:28:32 INFO - PROCESS | 1968 | Values: 88.0 70.0 86.0 70.0 68.0 70.0 83.0 70.0 71.0 103.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#5] imaging-gaussian-blur Cycles:10 Average:97.20 Median:88.00 stddev:19.33 (22.0%) stddev-sans-first:20.47 08:28:32 INFO - PROCESS | 1968 | Values: 94.0 131.0 136.0 86.0 89.0 86.0 89.0 87.0 89.0 85.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#6] imaging-darkroom Cycles:10 Average:107.40 Median:95.00 stddev:22.88 (24.1%) stddev-sans-first:24.26 08:28:32 INFO - PROCESS | 1968 | Values: 109.0 149.0 151.0 95.0 95.0 95.0 96.0 95.0 94.0 95.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#7] imaging-desaturate Cycles:10 Average:85.30 Median:86.00 stddev:2.11 (2.5%) stddev-sans-first:2.00 08:28:32 INFO - PROCESS | 1968 | Values: 88.0 85.0 85.0 88.0 86.0 81.0 86.0 83.0 86.0 85.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#8] json-parse-financial Cycles:10 Average:55.20 Median:56.00 stddev:1.69 (3.0%) stddev-sans-first:1.66 08:28:32 INFO - PROCESS | 1968 | Values: 57.0 54.0 52.0 53.0 55.0 56.0 56.0 56.0 57.0 56.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#9] json-stringify-tinderbox Cycles:10 Average:71.60 Median:72.50 stddev:2.99 (4.1%) stddev-sans-first:2.00 08:28:32 INFO - PROCESS | 1968 | Values: 65.0 73.0 75.0 75.0 74.0 70.0 71.0 72.0 71.0 70.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#10] stanford-crypto-aes Cycles:10 Average:83.50 Median:84.00 stddev:1.08 (1.3%) stddev-sans-first:1.13 08:28:32 INFO - PROCESS | 1968 | Values: 84.0 83.0 82.0 83.0 85.0 85.0 82.0 83.0 84.0 84.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#11] stanford-crypto-ccm Cycles:10 Average:147.70 Median:139.50 stddev:23.22 (16.6%) stddev-sans-first:24.41 08:28:32 INFO - PROCESS | 1968 | Values: 139.0 140.0 136.0 138.0 137.0 137.0 139.0 145.0 212.0 154.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.80 Median:170.00 stddev:14.70 (8.6%) stddev-sans-first:15.58 08:28:32 INFO - PROCESS | 1968 | Values: 170.0 170.0 168.0 170.0 170.0 167.0 175.0 166.0 152.0 210.0 08:28:32 INFO - PROCESS | 1968 | 08:28:32 INFO - PROCESS | 1968 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.70 Median:68.50 stddev:7.27 (10.6%) stddev-sans-first:7.65 08:28:32 INFO - PROCESS | 1968 | Values: 68.0 69.0 80.0 83.0 80.0 66.0 66.0 65.0 65.0 65.0 08:28:32 INFO - PROCESS | 1968 | -------- Summary: end -------- 08:28:32 INFO - PROCESS | 1968 | 08:28:33 INFO - TEST-INFO | 1968: exit 0 08:28:33 INFO - TEST-OK | kraken | took 59681ms 08:28:33 INFO - SUITE-END | took 1178s 08:28:33 INFO - Completed test suite (00:19:38) 08:28:33 INFO - javascript benchmark 08:28:33 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2976.315447447087, 3236.7572432067595, 3261.885833995812, 3281.228911205868, 3330.2673411849387, 4328.415663885375, 5474.616776825624, 5477.945220547798, 5483.341998960131, 5516.889662206759, 5402.78388864446, 5446.700431476267, 5458.181272809081, 5458.9454105458935, 5467.398586155529, 4974.10466116099, 4975.303457515951, 5053.0, 5059.038782631306, 5073.923891141636, 4241.978790106061, 4909.288153217782, 4991.226359914201, 4993.151164302078, 5110.0, 5031.522005409499, 5044.470330615288, 5054.9241761373605, 5060.342155519777, 5133.6919784813035, 5043.394792624872, 5079.619028572835, 5089.821856235051, 5096.847094587169, 5140.485951404867, 5018.698878067327, 5046.066477701637, 5069.112905241568, 5076.6192535559985, 5080.110980578384, 5294.894102117974, 5337.599680024014, 5397.865053373697, 5410.891782164374, 5463.535599474049, 4917.311576379309, 5924.58527903047, 5993.760249590011, 6006.699665016732, 6024.337322894478, 6032.698365081728, 6036.275646922353, 6063.727132279058, 6065.059915713072, 6085.300190478108, 5411.675299482044, 5545.639533430314, 5563.304586926634, 5568.916466252969, 5587.357453892854, 4932.605391568666, 5844.59087863854, 6176.320604733476, 6230.252369715572, 6254.562180647402, 5547.44525547442, 5910.822675319747, 5914.645121292736, 5918.615290006136, 5935.465808077208, 5988.670623115683, 6094.695265236721, 6107.6640784757265, 6134.171886795315, 6136.754529818846, 5787.479126878517, 5834.591578589458, 5839.970800145972, 5887.970560147171, 6008.459238668541, 5008.424031236382, 6037.78867739627, 6077.817665469955, 6083.878322433527, 6099.69501524922, 4864.416270047617, 4867.172580661296, 4871.829485968045, 4880.194767863334, 4896.167651499253, 4188.078622703, 4237.894052648647, 4323.0705398339505, 4338.696291259645, 4339.7830108494445, 5511.0080185566985, 5520.66875987442, 5559.499645031967, 5606.0, 5651.802186923438, 5902.468777810018, 5998.880022399528, 6005.609635373687, 6094.481969032593, 6129.570930034854, 5556.638818476786, 5570.359408667974, 5570.582206334541, 5600.719964001865, 5617.494425501724, 5185.974070129625, 5257.342832145981, 5282.841514754564, 5322.8935421292135, 5323.334583177103, 5326.627136100436, 6109.43503133753, 6114.844865410725, 6181.690915454119, 6182.598131121643, 6124.5712800103565, 6143.941779503916, 6144.433169541739, 6144.539159562962, 6144.801763656044, 6273.435390814849, 6298.370162983665, 6303.936960630518, 6307.022411526221, 6315.0, 5785.305763308262, 5872.794452194153, 5882.911756323744, 6031.487323577545, 6034.366391528826, 5995.400459954144, 6027.849303767441, 6033.487153591994, 6085.452309292008, 6113.510919126548, 5663.85840353978, 5787.39232380594, 5820.330661973758, 5831.125331200354, 5844.649321040752, 5656.773729050792, 5714.942850571441, 5805.94194058054, 5809.62237454581, 5816.360200377871, 4868.902621947612, 5510.6969116698965, 5533.059379905506, 5549.112142057252, 5588.966041282213, 5648.322201335866, 5649.971750141223, 5650.689212093374, 5653.067243904874, 5667.8866422672145, 5019.7741101651245, 5515.558755299647, 5533.280673512418, 5547.0, 5565.916511252415], "value": 5457.296995196569, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [417.78692866638005, 469.94595621503515, 489.30030057018473, 495.7422140486947, 507.21888292030275, 30743.231419214502, 32525.0, 40014.7999260004, 42155.57844421555, 42264.57735422645, 43343.0, 43700.56299437005, 43734.906627334334, 43784.78107609457, 43786.56213437865, 9198.586063627135, 9435.38669986452, 9435.481048542328, 9437.669681561147, 9451.95274023629, 8266.421350505467, 8483.618237179342, 10957.50691218897, 11225.32648041116, 11265.211435199539, 11231.32612043276, 11306.491207895624, 11334.773304533905, 11346.773064538704, 11349.20555561111, 8326.292265157468, 11282.887171128266, 11304.773904521946, 11312.660620181408, 11325.886741132566, 8282.461639993442, 8956.014838367775, 9129.954350228272, 9155.992840787509, 9320.673776417862, 40386.0, 40587.391189132184, 40650.39024414636, 40693.18613627711, 40745.79627101846, 3923.8822835314986, 3952.4268980997595, 4032.2741906456827, 4036.8385264589383, 4084.0, 29299.560506592417, 29371.41257174866, 29396.706032939826, 29466.70533294661, 30491.695083049108, 3087.5677405163296, 3174.2857856982223, 3351.329734053199, 3360.2103505676146, 3361.8823341182942, 350134.0, 356581.0, 358743.0, 359559.0, 359914.0, 62823.0, 63212.367876321565, 63286.36713632897, 63361.0, 63413.0, 57523.71238143783, 57928.71035644879, 65960.0, 66020.66989665022, 66159.33840661532, 14963.251837408086, 15188.848111518964, 15411.22943852803, 15414.768778468331, 15457.0, 10654.73363165927, 10935.453227338601, 11757.529698811952, 11850.0, 11855.703607409883, 14603.78094328586, 16464.0, 16817.915910420368, 16824.15879206035, 17247.74128388075, 6537.248216455074, 6996.440284777205, 7015.3686168244085, 7084.43324534036, 7098.112735908012, 853.795089178605, 854.2738672128766, 864.1833467373272, 872.7512658892185, 880.6662344786367, 24267.514649706907, 30020.249493762392, 30142.54786178209, 30837.0, 30974.53538196929, 1054.541274545575, 1058.1587637827945, 1066.6853278282924, 1070.2347821307803, 1186.655869797749, 15123.092614443169, 15435.691286174439, 15526.844731552766, 15604.141772202638, 15787.763183552255, 587687.0, 591663.0416847974, 593028.0, 593127.0, 596271.0, 61407.38592614106, 61533.0, 61605.76788464205, 61641.76716465735, 61716.382836171964, 1419.3045407750335, 1429.585420228143, 1448.0306782775629, 1448.608875603581, 1449.5578848451112, 28625.856870715514, 29296.56055159217, 29422.558661620522, 29437.85281073581, 30003.54994675038, 50957.0, 51209.71975700637, 51279.487205128964, 51361.229581557054, 51405.48594514007, 504635.0, 509641.0, 509760.0, 510043.0, 510153.0, 24831.25506234816, 25547.74452255528, 40373.99065023398, 40484.3927341096, 40887.0, 36327.81836090803, 37176.07059823526, 42033.73898783042, 43816.0, 44056.559434405244, 33945.424753594685, 36343.454848177826, 36510.8174459126, 37242.0, 37813.0, 32351.0, 32742.0, 35390.82304588461, 35655.82172089123, 35970.8201458991, 33258.0, 34568.65431345654, 35089.298214036084, 35133.82433087818, 35492.467612986344, 31232.063038108892, 31923.68076319207, 31992.36015279728, 32164.221585291038, 32473.512897306086, 23680.763192368544, 23720.169794057125, 24078.39804004914, 24218.0, 24289.27132186037], "value": 19515.467811142167, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [393.21945937314433, 401.1715806858836, 404.9514058313003, 407.75127172424817, 427.2928303657448, 20067.799322006776, 20071.698924516106, 20760.32090516715, 21249.57500849982, 21366.145354185832, 21152.788472115273, 21329.57340853182, 21434.57130857382, 21910.014049367775, 22151.44621384466, 5473.233747275394, 5624.409437009116, 5626.071698169818, 5626.774929002855, 5748.540116790647, 5490.3411590609185, 5664.943350566504, 5707.971460142693, 5734.827955161331, 5768.653880767168, 5688.516476099537, 5690.715464226772, 5690.857728556798, 5699.772009119631, 5709.543236541088, 5420.186971954218, 5630.127330263816, 5678.091505359143, 5678.48893599576, 5695.686737229451, 4956.801727930879, 4965.453800081988, 4993.550580447777, 5050.797968081272, 5056.62075344347, 25986.350341241432, 26324.341891452674, 26352.472950540883, 26446.471070578482, 26634.6004809928, 2662.4009597840522, 2685.328667833042, 2687.9651334236264, 2688.4891870544534, 2740.2053404512667, 14950.551483455514, 15390.230488475532, 15412.460563880322, 15744.448944286894, 16086.954347967345, 1738.7304967730022, 1785.3394244129624, 1794.784625844894, 1798.3615816385256, 1816.4641430777951, 126469.0, 129593.32116879508, 134896.999999999, 135582.0, 135660.0, 11190.776184476428, 11308.660740177807, 11609.6517104487, 11751.706207344714, 11783.35191564455, 14479.276036198147, 14486.203258820655, 14499.710005800036, 14500.0, 14513.782293265609, 6926.341997510229, 8047.758567242875, 8202.425830191949, 8290.37822163328, 8361.205685459872, 7719.189485104095, 7999.4400391972, 8019.117897031322, 8169.0, 8190.631421586043, 6945.131858517685, 7040.788776336718, 7041.119860017498, 7046.224915259318, 7061.752838650623, 1890.3005887821594, 1922.7884932657396, 1933.2073849721828, 1935.5838494723703, 1935.9322423715103, 852.3990586636406, 856.1310270075878, 889.3285569395065, 891.8974317953389, 900.6667533012827, 21016.0, 21123.471913202295, 21286.254981075897, 21437.785622143892, 21598.56802863934, 771.7954741993376, 897.4166791585391, 930.8045310484874, 932.8134373125403, 938.5870217104452, 10840.915908409095, 11349.205555611194, 11435.656930292105, 11582.420878956018, 11625.88374116248, 736146.0, 737892.0, 742445.0, 746360.0, 757000.0, 163170.0, 164996.17501912414, 165115.1744241295, 166303.0, 172667.0, 1009.3338396658318, 1045.900639439252, 1047.4448542272455, 1068.3963560588243, 1068.8824229334923, 18956.336528221447, 19452.0, 19748.40754777359, 19884.90057549703, 19896.50258743543, 61026.38973610385, 61432.692836535534, 63109.68445157745, 64090.0, 64225.71548568909, 89661.0, 90162.0, 93281.0, 93893.0, 94309.0, 8104.554249516334, 8122.147174546824, 8157.8368432632205, 8602.268807151462, 8658.870116948125, 9333.85999210026, 12669.176503527242, 12854.871451285368, 13353.66615834612, 13365.53220637273, 9047.68333108338, 9189.356745028052, 10989.0, 11240.988311052044, 11249.550017999189, 10972.780544389227, 11144.777104458028, 11200.0, 11381.317120972768, 11544.0, 11371.20401571882, 11404.087672986307, 11465.656030319104, 11687.675560042839, 11820.70448238801, 6277.435030847246, 7583.620818959141, 8322.292605128632, 8550.657973680984, 8587.9694436668, 5654.378018418053, 6890.724371025303, 9270.119338662817, 11023.283486573348, 11555.133364997828], "value": 9984.785034820005, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1307.960761177165, 1423.2243427332103, 1430.449277028344, 1447.2618964328192, 1448.0659974316566, 7477.364424023957, 7851.803704907373, 8088.393370497207, 8418.536980466071, 8429.325653947684, 8325.542095184777, 8345.91654083459, 8375.288100511463, 8466.941632295962, 8488.108748581402, 1994.2621230144866, 2036.297477370305, 2119.9364019079453, 2289.679444877714, 2340.648902664597, 2285.074544809355, 2371.95256094878, 2372.3120295114395, 2386.486905315357, 2389.5579317826173, 2305.7578954209816, 2335.6262997920335, 2343.6367363058753, 2349.530093981202, 2350.9412264693347, 2043.1827269092332, 2123.980489365098, 2326.988365058181, 2344.0623750499853, 2362.6692263083182, 2107.525806693497, 2231.5090680050525, 2307.976920230793, 2312.09828167015, 2317.88410579472, 8455.577221138918, 8488.74533763988, 8504.064552899175, 8505.149485051506, 8514.446560973578, 4967.180415231483, 5142.280080788692, 5149.613778966555, 5152.793888244466, 5157.123289040872, 3351.798892066484, 3457.3949558827103, 3482.6169121396624, 3521.084518025332, 3545.0251180925193, 1174.5360582569838, 1200.9459574319176, 1207.9456424460832, 1247.6756043428684, 1276.183242724657, 10847.945760271226, 10907.67276981684, 11019.504122314514, 11032.669019929415, 11037.11703063745, 4549.3176023596725, 4634.652401069866, 4692.671512994126, 4729.456112547101, 4784.784684689197, 9581.616735330648, 9587.137157655845, 9588.185004274716, 9621.941586425488, 9624.03759624046, 5272.182811664198, 5297.470252974672, 5300.655457395257, 5301.0723123453245, 5312.814051508179, 4646.605038571692, 4743.146233677971, 4744.0, 4818.807247710052, 4836.733979631154, 3875.5349358076646, 3884.1454879926373, 3932.2528719543197, 3973.0663294125857, 3995.34193309779, 1274.4838340472124, 1274.9490020399267, 1278.0, 1292.0438875232448, 1293.6442478318538, 767.8042099264652, 767.9347255483235, 795.9403044771665, 797.3023604346197, 802.6388125343618, 5404.486573775485, 5408.621396502286, 5423.311909862781, 5535.557155427556, 5573.637713548606, 555.3696554410773, 558.132104577386, 558.2240685447232, 563.892860356531, 571.8313097636208, 3559.715222782171, 3598.2623562169692, 3606.2246616977477, 3613.2954073955852, 3669.3028324618235, 9644.855327170098, 10049.397036177852, 10058.245631577662, 10175.236857235737, 10234.385936843813, 9910.0, 10020.148287395506, 10024.248181386425, 10037.297389182688, 10055.798884022279, 7615.504992175491, 7750.0, 7764.61176941162, 7768.533887966627, 7878.212178782191, 5185.351831021122, 5246.711430871186, 5372.838814835562, 5431.293931788842, 5526.032944234663, 9275.0, 9392.96677365503, 9418.293627978066, 9422.115576884788, 9461.38500997433, 9031.50326732036, 9258.305627077862, 9396.624135034795, 9459.527023648927, 9472.810543789223, 6898.896516552356, 7084.079069720903, 7148.606826624377, 7204.603746793767, 7206.315400036988, 6699.598024118569, 7633.961830190813, 7683.231676832272, 7845.0585929688805, 7855.057393112863, 6943.722251110101, 6944.756933507505, 6988.9301106990315, 7024.1571011478945, 7159.749408770668, 6154.692265386802, 6821.386075253251, 6825.2833452486775, 6946.201186863374, 7001.614911179934, 6279.120923070683, 6452.0, 6468.256150542559, 6473.061406096184, 6478.384553467413, 4809.350737650372, 4832.782524786463, 4905.558499735041, 4933.963867587847, 5017.046761115376, 4188.476440444944, 4872.123017856819, 4940.802367905388, 4963.230699241623, 5080.26336181259], "value": 4329.004327508193, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [283.9943201135977, 340.6746557038027, 358.7022771099987, 363.94456077375617, 373.7888093227328, 5162.638615296931, 5179.3067604845555, 5286.524212820846, 5348.117560602501, 5349.518543331104, 4581.9083618327695, 5205.141151709963, 5231.947680523193, 5255.658382205154, 5283.867903302419, 3442.776219545734, 3870.767753934766, 3983.9442547724875, 3989.820458079379, 4007.5992400759983, 3778.394182472452, 3882.1365744442683, 4090.5909409059154, 4101.8974525636795, 4109.28087584673, 3892.4939757831585, 4135.58644135587, 4155.709100362976, 4158.625723684868, 4174.624283814456, 3499.5800503939563, 3704.814759262053, 3929.960700392988, 4165.958510372392, 4197.91604167918, 2945.587617733519, 3582.301451217014, 3610.4403817408343, 3669.1377526281303, 3694.1688120173017, 4294.570542945712, 4320.891977700551, 5062.265971434158, 5068.366454193226, 5077.644564880423, 4673.88315292117, 4695.3661255730385, 4716.363290955712, 4759.833405830779, 4772.093302272557, 4251.447311849471, 4444.244568367601, 5357.651752636066, 5546.084895992197, 5670.262865827457, 4053.8175782089875, 4056.776877271749, 4058.3303754880408, 4070.432883339906, 4079.0618157823865, 4641.837535686234, 4926.433460152092, 5638.4925356718095, 5700.543956483471, 5820.1269809528485, 3950.7234493585174, 3997.540282867449, 4117.629413352813, 4120.25835349634, 4124.8556300529335, 3407.0460271124125, 3665.9450108248398, 4194.895127621834, 4195.7692326922315, 4210.2842516772225, 3832.3676593362343, 4624.653151013687, 4718.457377401574, 4751.59611433032, 4770.928436073462, 5319.547838433699, 5579.832605021856, 5600.327960644749, 5618.073017952074, 5675.432456754292, 1215.3497878634887, 1217.8004665404746, 1337.2979185927466, 1349.7840345544666, 1390.728807882453, 811.4522697179381, 850.268768858781, 968.7384406210284, 973.6932866147141, 980.7989362180735, 4232.851850185229, 4561.585908368416, 4910.729909854992, 5003.4746351633285, 5112.90072634378, 4319.594014105594, 4944.121233931083, 5394.1929453633475, 5463.562914966793, 5617.623682197806, 4632.2438149301115, 4741.739204343794, 4777.737224452689, 4893.804247830119, 4962.982588569334, 2515.4340273438697, 2816.8873245070376, 2827.6182715333166, 2831.0940499040107, 2844.5164322065298, 4873.31773551703, 4909.93782611297, 5182.818601348935, 5566.886622675481, 5637.8590535236945, 4566.360709500673, 4957.405111386584, 4996.0, 5211.8175863845345, 5548.278723765965, 4911.901761964741, 5265.420803711665, 5595.972020139873, 5606.831795046155, 5634.492895639412, 5272.9736351318, 5392.811251606175, 5421.756020978986, 5457.20870473787, 5461.399246082849, 4513.796879140381, 4929.806236224846, 5623.578231632562, 5637.57718171147, 5697.800576979952, 4570.131674981876, 5582.995060889079, 5586.40787375596, 5642.153676948491, 5926.525877929842, 3790.0102446214855, 3802.2775672622115, 3812.5424949006297, 3816.9121800286784, 3830.712696547826, 5442.972785136049, 5621.662700237835, 5641.717914104361, 5667.631603945731, 5672.886542269214, 5368.758405871667, 5476.616636835383, 5498.010358135414, 5506.366767821752, 5518.668879867221, 5089.7709603067215, 5103.362079740033, 5313.256144139901, 5481.945180548143, 5564.415736347787, 4547.749873756975, 4740.454847692422, 4879.804807807648, 5365.517103460707, 5433.782648694008, 5450.8909821802545, 5479.3972663007835, 5480.972595136999, 5514.91727624094, 5516.641418307797, 5388.703621300866, 5406.2701535292235, 5441.2654291670115, 5463.235147079333, 5466.808661696821], "value": 4034.052906524261, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [702.094298355122, 760.7261385901074, 811.5495899775624, 819.1112642782581, 821.3593397150217, 12857.421416036277, 13115.0, 13319.334033298344, 13336.33318334083, 13416.798748018775, 14355.354009069591, 14408.135511869295, 14414.135151890894, 14447.566573002827, 14453.92773036136, 654.1790053482872, 674.2684187656399, 678.5589366911497, 679.7484930575694, 841.9368547358941, 683.1801837794666, 683.3849535418138, 829.3365307753803, 853.1766844994579, 857.2413414128509, 905.2622112977901, 907.6550910653942, 908.4503875155535, 908.5502676175303, 915.6566287642135, 764.3273918951343, 884.8938127424686, 909.3316412436886, 909.7725568607848, 911.8996910339857, 674.8549061951655, 677.2448719677574, 677.7153595489906, 677.7153595489906, 679.8198477403492, 12056.6383008509, 12565.120441569003, 14668.193249371281, 15165.848341516665, 15267.236638168159, 13149.605511834565, 14458.49395271171, 14568.271586420637, 14643.56069317922, 14708.117512949257, 11053.447327633667, 11542.653720388402, 11809.40952952349, 11882.643520694393, 11990.520379184909, 3516.6307537708685, 3620.11730937227, 3653.561572611277, 3688.6495782900583, 3735.2435586864217, 101928.0, 104080.47959760153, 106041.46979265055, 107948.92051079468, 107953.46023269912, 10077.193824494023, 10613.416262105504, 10771.892281077246, 10843.78312433747, 11148.163887708455, 21476.0, 21614.35156945294, 21819.345419637437, 21970.231041913456, 21984.120635174735, 6580.736770529221, 7497.212792656802, 7598.886016709644, 7716.189800070912, 7807.9849619549095, 4262.616364527207, 4268.277512675975, 4285.228658841438, 4290.635295999812, 4330.2638551446325, 3548.7870727756417, 3593.191531905353, 3612.476190952297, 3633.3096711624707, 3665.211979424383, 659.3966520633662, 662.4998126414526, 666.3736088077192, 667.7796327212009, 677.3429773120066, 657.8750037492861, 673.4881490067584, 681.4173881331391, 700.1318365227082, 716.1477841368859, 9652.710418687451, 9713.514324283757, 9906.0, 9989.523908823321, 10050.261209735267, 655.2824657000576, 680.3433639088736, 689.2969171445199, 711.1466240511407, 713.8500914807948, 4560.977195114069, 4965.528274813887, 4986.975065124651, 4997.750112494361, 5005.424376196711, 104780.0, 105699.47150264353, 106214.46892765642, 106360.0, 107746.0, 66540.0, 99865.0, 100201.0, 100900.0, 102709.0, 81089.0, 81353.59323203465, 81636.59181704173, 81686.18875008676, 84092.0, 9475.620975161191, 9712.02879712023, 9718.271129665161, 9729.978352273192, 9803.509824508888, 39674.60325396709, 47286.81782955454, 48298.0, 49118.508814911394, 50266.0, 62825.371746281955, 62921.0, 64029.67985160044, 64667.67666161827, 65719.34280657323, 11336.489857956247, 11461.598844040418, 11495.942520287344, 11564.595239166589, 11761.353125577833, 12144.635660930186, 12324.753504930031, 12348.691282718004, 12394.62816115518, 12400.441980110736, 11756.764864702487, 11834.704132396759, 11883.405829708307, 11908.76182476363, 11936.880631193924, 11530.654080377602, 11736.354500502553, 11877.643670689893, 11939.82090268664, 12013.79022563103, 10356.741081472723, 11361.147913906656, 12406.317652529198, 13283.800742989057, 13332.200067995951, 10658.786824263627, 10759.515821788194, 10963.780724385628, 11237.55049797999, 11370.488328025092, 10451.21615878797, 10650.64504681023, 10763.408012559385, 10783.0, 10816.459177041274], "value": 7284.062234154113, "unit": "score"}], "name": "dromaeo_css", "value": 7164.8641542761825, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 114.0, 115.0, 122.0, 166.0, 152.0, 114.0, 115.0, 115.0, 115.0], "value": 124.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 109.0, 110.0, 142.0, 111.0, 139.0, 138.0, 110.0, 130.0, 111.0], "value": 124.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [186.0, 184.0, 185.0, 186.0, 182.0, 184.0, 187.0, 186.0, 185.0, 183.0], "value": 184.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 59.0, 60.0, 91.0, 60.0, 59.0, 57.0, 58.0, 73.0, 58.0], "value": 65.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 70.0, 86.0, 70.0, 68.0, 70.0, 83.0, 70.0, 71.0, 103.0], "value": 77.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 131.0, 136.0, 86.0, 89.0, 86.0, 89.0, 87.0, 89.0, 85.0], "value": 97.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 149.0, 151.0, 95.0, 95.0, 95.0, 96.0, 95.0, 94.0, 95.0], "value": 107.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 85.0, 85.0, 88.0, 86.0, 81.0, 86.0, 83.0, 86.0, 85.0], "value": 85.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 54.0, 52.0, 53.0, 55.0, 56.0, 56.0, 56.0, 57.0, 56.0], "value": 55.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 73.0, 75.0, 75.0, 74.0, 70.0, 71.0, 72.0, 71.0, 70.0], "value": 71.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 82.0, 83.0, 85.0, 85.0, 82.0, 83.0, 84.0, 84.0], "value": 83.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 140.0, 136.0, 138.0, 137.0, 137.0, 139.0, 145.0, 212.0, 154.0], "value": 147.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 170.0, 168.0, 170.0, 170.0, 167.0, 175.0, 166.0, 152.0, 210.0], "value": 171.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 69.0, 80.0, 83.0, 80.0, 66.0, 66.0, 65.0, 65.0, 65.0], "value": 70.7, "unit": "score"}], "name": "kraken", "value": 1466.8, "alertThreshold": 2.0}]} 08:28:33 INFO - Return code: 0 08:28:33 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:28:33 ERROR - # TBPL SUCCESS # 08:28:33 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:28:33 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:28:33 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:28:33 INFO - 2017-02-14 08:28:33.963 screenresolution[1972:16898] starting screenresolution argv=screenresolution get 08:28:33 INFO - 2017-02-14 08:28:33.966 screenresolution[1972:16898] Display 0: 1600x1200x32@60 08:28:33 INFO - 2017-02-14 08:28:33.973 screenresolution[1973:16901] starting screenresolution argv=screenresolution list 08:28:33 INFO - Available Modes on Display 0 08:28:33 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:28:33 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:28:33 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:28:33 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:28:34 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:28:34 INFO - Intel Iris: 08:28:34 INFO - Chipset Model: Intel Iris 08:28:34 INFO - Type: GPU 08:28:34 INFO - Bus: Built-In 08:28:34 INFO - VRAM (Dynamic, Max): 1536 MB 08:28:34 INFO - Vendor: Intel (0x8086) 08:28:34 INFO - Device ID: 0x0a2e 08:28:34 INFO - Revision ID: 0x0009 08:28:34 INFO - Displays: 08:28:34 INFO - Display: 08:28:34 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:28:34 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:28:34 INFO - Display Serial Number: 1600x1200 60 08:28:34 INFO - Main Display: Yes 08:28:34 INFO - Mirror: Off 08:28:34 INFO - Online: Yes 08:28:34 INFO - Rotation: Supported 08:28:34 INFO - Return code: 0 08:28:34 INFO - Running post-action listener: _resource_record_post_action 08:28:34 INFO - [mozharness: 2017-02-14 16:28:34.217019Z] Finished run-tests step (success) 08:28:34 INFO - Running post-run listener: _resource_record_post_run 08:28:34 INFO - Total resource usage - Wall time: 1199s; CPU: 54.0%; Read bytes: 1638400; Write bytes: 507794432; Read time: 14; Write time: 1569 08:28:34 INFO - TinderboxPrint: CPU usage
53.5% 08:28:34 INFO - TinderboxPrint: I/O read bytes / time
1,638,400 / 14 08:28:34 INFO - TinderboxPrint: I/O write bytes / time
507,794,432 / 1,569 08:28:34 INFO - TinderboxPrint: CPU idle
2,229.6 (46.5%) 08:28:34 INFO - TinderboxPrint: CPU system
959.8 (20.0%) 08:28:34 INFO - TinderboxPrint: CPU user
1,608.4 (33.5%) 08:28:34 INFO - TinderboxPrint: Swap in / out
209,575,936 / 0 08:28:34 INFO - install - Wall time: 20s; CPU: 54.0%; Read bytes: 205345280; Write bytes: 200279552; Read time: 15728; Write time: 427 08:28:34 INFO - run-tests - Wall time: 1179s; CPU: 54.0%; Read bytes: 1638400; Write bytes: 296549888; Read time: 14; Write time: 1102 08:28:34 INFO - Running post-run listener: _upload_blobber_files 08:28:34 INFO - Blob upload gear active. 08:28:34 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:28:34 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 08:28:34 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', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:28:34 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 Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:28:35 INFO - (blobuploader) - INFO - Open directory for files ... 08:28:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:28:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:28:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:28:35 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:28:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:28:35 INFO - (blobuploader) - INFO - Done attempting. 08:28:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:28:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:28:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:28:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:28:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:28:36 INFO - (blobuploader) - INFO - Done attempting. 08:28:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 08:28:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:28:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:28:37 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 08:28:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:28:37 INFO - (blobuploader) - INFO - Done attempting. 08:28:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:28:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:28:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:28:39 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:28:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:28:39 INFO - (blobuploader) - INFO - Done attempting. 08:28:39 INFO - (blobuploader) - INFO - Iteration through files over. 08:28:39 INFO - Return code: 0 08:28:39 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:28:39 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:28:39 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/777f9ef43d48bfdb9fd9aed4cee43b41721db85475286b24d04c6530cbdfd0c150cef1ee8fd92d7fb7a96a073828d7efd80a05ad74c4aa7c8a002c219afef1ff", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c9976ca300b37aed44ba5c68026b31867153017edc302d68c621477e98c5f2a1878c08321e9e3eabd620758c55b9881f545285955acce7a154148f63dcf663e8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0a43b07d7f1821d1ebfacd234b06b83c6cd55a3c04ae001fda975b0ba87e77c07fbccfa396cf307457e1c0b984d355bf3b9543127780b38167b4628c1b899f76", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/73183ac9671afbb555f136cbd9c33067bb178abe062a316e86eed1681baca42bef5e62aac54cba4e212e3d0acd293d22d390ef932dea20dee2d551709aaac7d1"} 08:28:39 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:28:39 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:28:39 INFO - Contents: 08:28:39 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/777f9ef43d48bfdb9fd9aed4cee43b41721db85475286b24d04c6530cbdfd0c150cef1ee8fd92d7fb7a96a073828d7efd80a05ad74c4aa7c8a002c219afef1ff", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c9976ca300b37aed44ba5c68026b31867153017edc302d68c621477e98c5f2a1878c08321e9e3eabd620758c55b9881f545285955acce7a154148f63dcf663e8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0a43b07d7f1821d1ebfacd234b06b83c6cd55a3c04ae001fda975b0ba87e77c07fbccfa396cf307457e1c0b984d355bf3b9543127780b38167b4628c1b899f76", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/73183ac9671afbb555f136cbd9c33067bb178abe062a316e86eed1681baca42bef5e62aac54cba4e212e3d0acd293d22d390ef932dea20dee2d551709aaac7d1"} 08:28:39 INFO - Running post-run listener: copy_logs_to_upload_dir 08:28:39 INFO - Copying logs to upload dir... 08:28:39 INFO - mkdir: /builds/slave/test/build/upload/logs 08:28:39 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1257.025161 ========= master_lag: 0.10 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2017-02-14 08:28:40.023336) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-14 08:28:40.030109) ========= 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.VbCcMtJyln/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.5kW3qGWzlf/Listeners TMPDIR=/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/777f9ef43d48bfdb9fd9aed4cee43b41721db85475286b24d04c6530cbdfd0c150cef1ee8fd92d7fb7a96a073828d7efd80a05ad74c4aa7c8a002c219afef1ff", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c9976ca300b37aed44ba5c68026b31867153017edc302d68c621477e98c5f2a1878c08321e9e3eabd620758c55b9881f545285955acce7a154148f63dcf663e8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0a43b07d7f1821d1ebfacd234b06b83c6cd55a3c04ae001fda975b0ba87e77c07fbccfa396cf307457e1c0b984d355bf3b9543127780b38167b4628c1b899f76", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/73183ac9671afbb555f136cbd9c33067bb178abe062a316e86eed1681baca42bef5e62aac54cba4e212e3d0acd293d22d390ef932dea20dee2d551709aaac7d1"} build_url:https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011200 build_url: 'https://queue.taskcluster.net/v1/task/RW3NKNVzR02tgiKtLdUFAg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/777f9ef43d48bfdb9fd9aed4cee43b41721db85475286b24d04c6530cbdfd0c150cef1ee8fd92d7fb7a96a073828d7efd80a05ad74c4aa7c8a002c219afef1ff", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c9976ca300b37aed44ba5c68026b31867153017edc302d68c621477e98c5f2a1878c08321e9e3eabd620758c55b9881f545285955acce7a154148f63dcf663e8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0a43b07d7f1821d1ebfacd234b06b83c6cd55a3c04ae001fda975b0ba87e77c07fbccfa396cf307457e1c0b984d355bf3b9543127780b38167b4628c1b899f76", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/73183ac9671afbb555f136cbd9c33067bb178abe062a316e86eed1681baca42bef5e62aac54cba4e212e3d0acd293d22d390ef932dea20dee2d551709aaac7d1"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-14 08:28:40.066874) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-14 08:28:40.067228) ========= 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.VbCcMtJyln/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.5kW3qGWzlf/Listeners TMPDIR=/var/folders/cq/fm9x62sj2nq5lg90gjyc1tb000000w/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.005305 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-14 08:28:40.122421) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-14 08:28:40.124717) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-14 08:28:40.125042) ========= ========= Total master_lag: 0.26 =========