builder: mozilla-central_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0265 starttime: 1488478323.38 results: success (0) buildid: 20170302074351 builduid: e86f8fb5939b4ca3892987b3aab9ef0f revision: d29f84406483c721a13cf9a52936ecced0c5c98a ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:03.383192) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:03.383616) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:03.383886) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:03.410531) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:03.410851) ========= 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.QcXlEKos6J/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.XXpfBEumK3/Listeners TMPDIR=/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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-03-02 10:12:03-- 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% 149M=0s 2017-03-02 10:12:03 (149 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.118723 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:03.553549) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:03.553857) ========= 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.QcXlEKos6J/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.XXpfBEumK3/Listeners TMPDIR=/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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.020632 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:03.601707) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2017-03-02 10:12:03.602030) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev d29f84406483c721a13cf9a52936ecced0c5c98a --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev d29f84406483c721a13cf9a52936ecced0c5c98a --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.QcXlEKos6J/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.XXpfBEumK3/Listeners TMPDIR=/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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-03-02 10:12:03,693 truncating revision to first 12 chars 2017-03-02 10:12:03,694 Setting DEBUG logging. 2017-03-02 10:12:03,694 attempt 1/10 2017-03-02 10:12:03,694 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/d29f84406483?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-02 10:12:05,539 unpacking tar archive at: mozilla-central-d29f84406483/testing/mozharness/ program finished with exit code 0 elapsedTime=2.111508 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2017-03-02 10:12:05.737220) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:05.737537) ========= script_repo_revision: d29f84406483c721a13cf9a52936ecced0c5c98a ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:05.737911) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:05.738184) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-02 10:12:05.758007) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 25 secs) (at 2017-03-02 10:12:05.758318) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.QcXlEKos6J/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.XXpfBEumK3/Listeners TMPDIR=/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:12:05 INFO - MultiFileLogger online at 20170302 10:12:05 in /builds/slave/test 10:12:05 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 10:12:05 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:12:05 INFO - {'append_to_log': False, 10:12:05 INFO - 'base_work_dir': '/builds/slave/test', 10:12:05 INFO - 'blob_upload_branch': 'Firefox', 10:12:05 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:12:05 INFO - 'branch': 'Firefox', 10:12:05 INFO - 'buildbot_json_path': 'buildprops.json', 10:12:05 INFO - 'config_files': ('talos/mac_config.py',), 10:12:05 INFO - 'default_actions': ('clobber', 10:12:05 INFO - 'read-buildbot-config', 10:12:05 INFO - 'download-and-extract', 10:12:05 INFO - 'populate-webroot', 10:12:05 INFO - 'create-virtualenv', 10:12:05 INFO - 'install', 10:12:05 INFO - 'run-tests'), 10:12:05 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:12:05 INFO - 'download_minidump_stackwalk': True, 10:12:05 INFO - 'download_symbols': 'ondemand', 10:12:05 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:12:05 INFO - 'tooltool.py': '/tools/tooltool.py', 10:12:05 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:12:05 INFO - '/tools/misc-python/virtualenv.py')}, 10:12:05 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:12:05 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:12:05 INFO - 'gecko_profile': False, 10:12:05 INFO - 'gecko_profile_interval': 0, 10:12:05 INFO - 'installer_path': 'installer.exe', 10:12:05 INFO - 'log_level': 'info', 10:12:05 INFO - 'log_name': 'talos', 10:12:05 INFO - 'log_to_console': True, 10:12:05 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 10:12:05 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 10:12:05 INFO - 'opt_config_files': (), 10:12:05 INFO - 'pip_index': False, 10:12:05 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:12:05 INFO - 'cmd': ('bash', 10:12:05 INFO - '-c', 10:12:05 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:12:05 INFO - 'enabled': True, 10:12:05 INFO - 'halt_on_failure': False, 10:12:05 INFO - 'name': 'check_screen_resolution'},), 10:12:05 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:12:05 INFO - 'cmd': ('bash', 10:12:05 INFO - '-c', 10:12:05 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:12:05 INFO - 'enabled': True, 10:12:05 INFO - 'halt_on_failure': False, 10:12:05 INFO - 'name': 'check_screen_resolution'},), 10:12:05 INFO - 'run_cmd_checks_enabled': True, 10:12:05 INFO - 'suite': 'dromaeojs', 10:12:05 INFO - 'system_bits': '32', 10:12:05 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:12:05 INFO - 'title': 't-yosemite-r7-0265', 10:12:05 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:12:05 INFO - 'use_talos_json': True, 10:12:05 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:12:05 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:12:05 INFO - 'work_dir': 'build'} 10:12:05 INFO - [mozharness: 2017-03-02 18:12:05.965102Z] Running clobber step. 10:12:05 INFO - Running pre-action listener: _resource_record_pre_action 10:12:05 INFO - Running main action method: clobber 10:12:05 INFO - rmtree: /builds/slave/test/build 10:12:05 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:12:06 INFO - Running post-action listener: _resource_record_post_action 10:12:06 INFO - [mozharness: 2017-03-02 18:12:06.296240Z] Finished clobber step (success) 10:12:06 INFO - [mozharness: 2017-03-02 18:12:06.296430Z] Running read-buildbot-config step. 10:12:06 INFO - Running pre-action listener: _resource_record_pre_action 10:12:06 INFO - Running main action method: read_buildbot_config 10:12:06 INFO - Using buildbot properties: 10:12:06 INFO - { 10:12:06 INFO - "project": "", 10:12:06 INFO - "product": "firefox", 10:12:06 INFO - "script_repo_revision": "production", 10:12:06 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs", 10:12:06 INFO - "repository": "", 10:12:06 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs", 10:12:06 INFO - "buildid": "20170302074351", 10:12:06 INFO - "pgo_build": "False", 10:12:06 INFO - "basedir": "/builds/slave/test", 10:12:06 INFO - "buildnumber": 61, 10:12:06 INFO - "slavename": "t-yosemite-r7-0265", 10:12:06 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 10:12:06 INFO - "platform": "yosemite_r7", 10:12:06 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 10:12:06 INFO - "branch": "mozilla-central", 10:12:06 INFO - "repo_path": "mozilla-central", 10:12:06 INFO - "revision": "d29f84406483c721a13cf9a52936ecced0c5c98a", 10:12:06 INFO - "stage_platform": "macosx64", 10:12:06 INFO - "builduid": "e86f8fb5939b4ca3892987b3aab9ef0f", 10:12:06 INFO - "slavebuilddir": "test" 10:12:06 INFO - } 10:12:06 INFO - Found installer url https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.dmg. 10:12:06 INFO - Running post-action listener: _resource_record_post_action 10:12:06 INFO - [mozharness: 2017-03-02 18:12:06.300570Z] Finished read-buildbot-config step (success) 10:12:06 INFO - [mozharness: 2017-03-02 18:12:06.300730Z] Running download-and-extract step. 10:12:06 INFO - Running pre-action listener: _resource_record_pre_action 10:12:06 INFO - Running main action method: download_and_extract 10:12:06 INFO - mkdir: /builds/slave/test/build/tests 10:12:06 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')]} 10:12:06 INFO - trying https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.test_packages.json 10:12:06 INFO - Downloading https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-54.0a1.en-US.mac.test_packages.json 10:12:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-54.0a1.en-US.mac.test_packages.json'}, attempt #1 10:12:07 INFO - Downloaded 1199 bytes. 10:12:07 INFO - Reading from file /builds/slave/test/build/firefox-54.0a1.en-US.mac.test_packages.json 10:12:07 INFO - Using the following test package requirements: 10:12:07 INFO - {u'common': [u'firefox-54.0a1.en-US.mac.common.tests.zip'], 10:12:07 INFO - u'cppunittest': [u'firefox-54.0a1.en-US.mac.common.tests.zip', 10:12:07 INFO - u'firefox-54.0a1.en-US.mac.cppunittest.tests.zip'], 10:12:07 INFO - u'gtest': [u'firefox-54.0a1.en-US.mac.common.tests.zip', 10:12:07 INFO - u'firefox-54.0a1.en-US.mac.gtest.tests.zip'], 10:12:07 INFO - u'jittest': [u'firefox-54.0a1.en-US.mac.common.tests.zip', 10:12:07 INFO - u'jsshell-mac.zip'], 10:12:07 INFO - u'mochitest': [u'firefox-54.0a1.en-US.mac.common.tests.zip', 10:12:07 INFO - u'firefox-54.0a1.en-US.mac.mochitest.tests.zip'], 10:12:07 INFO - u'mozbase': [u'firefox-54.0a1.en-US.mac.common.tests.zip'], 10:12:07 INFO - u'reftest': [u'firefox-54.0a1.en-US.mac.common.tests.zip', 10:12:07 INFO - u'firefox-54.0a1.en-US.mac.reftest.tests.zip'], 10:12:07 INFO - u'talos': [u'firefox-54.0a1.en-US.mac.common.tests.zip', 10:12:07 INFO - u'firefox-54.0a1.en-US.mac.talos.tests.zip'], 10:12:07 INFO - u'web-platform': [u'firefox-54.0a1.en-US.mac.common.tests.zip', 10:12:07 INFO - u'firefox-54.0a1.en-US.mac.web-platform.tests.zip'], 10:12:07 INFO - u'xpcshell': [u'firefox-54.0a1.en-US.mac.common.tests.zip', 10:12:07 INFO - u'firefox-54.0a1.en-US.mac.xpcshell.tests.zip']} 10:12:07 INFO - Downloading packages: [u'firefox-54.0a1.en-US.mac.common.tests.zip'] for test suite category: common 10:12:07 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.common.tests.zip 10:12:07 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.common.tests.zip'}, attempt #1 10:12:07 INFO - Fetch https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.common.tests.zip into memory 10:12:09 INFO - Expected file size: 51771274 10:12:09 INFO - Obtained file size: 51771274 10:12:25 INFO - Downloading packages: [u'firefox-54.0a1.en-US.mac.common.tests.zip', u'firefox-54.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 10:12:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.common.tests.zip 10:12:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.common.tests.zip'}, attempt #1 10:12:25 INFO - Fetch https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.common.tests.zip into memory 10:12:26 INFO - Expected file size: 51771274 10:12:26 INFO - Obtained file size: 51771274 10:12:41 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.talos.tests.zip 10:12:41 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.talos.tests.zip'}, attempt #1 10:12:41 INFO - Fetch https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.talos.tests.zip into memory 10:12:43 INFO - Expected file size: 14404424 10:12:43 INFO - Obtained file size: 14404424 10:12:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:44 INFO - trying https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.dmg 10:12:44 INFO - Downloading https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-54.0a1.en-US.mac.dmg 10:12:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-54.0a1.en-US.mac.dmg'}, attempt #1 10:12:46 INFO - Downloaded 75028894 bytes. 10:12:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.dmg 10:12:46 INFO - mkdir: /builds/slave/test/properties 10:12:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:12:46 INFO - Writing to file /builds/slave/test/properties/build_url 10:12:46 INFO - Contents: 10:12:46 INFO - build_url:https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.dmg 10:12:47 INFO - Running post-action listener: _resource_record_post_action 10:12:47 INFO - Running post-action listener: set_extra_try_arguments 10:12:47 INFO - [mozharness: 2017-03-02 18:12:47.024575Z] Finished download-and-extract step (success) 10:12:47 INFO - [mozharness: 2017-03-02 18:12:47.024699Z] Running populate-webroot step. 10:12:47 INFO - Running pre-action listener: _resource_record_pre_action 10:12:47 INFO - Running main action method: populate_webroot 10:12:47 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:12:47 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:12:47 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:12:47 INFO - '--tppagecycles', 10:12:47 INFO - '7'], 10:12:47 INFO - 'tests': ['tsvgm']}}, 10:12:47 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:12:47 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:12:47 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:12:47 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:12:47 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 10:12:47 INFO - 'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:12:47 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 10:12:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:12:47 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 10:12:47 INFO - 'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['damp', 'tps']}, 10:12:47 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 10:12:47 INFO - 'tests': ['damp', 'tps']}, 10:12:47 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['dromaeo_dom']}, 10:12:47 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:12:47 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['basic_compositor_video']}, 10:12:47 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:12:47 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['a11yr', 10:12:47 INFO - 'ts_paint', 10:12:47 INFO - 'tpaint', 10:12:47 INFO - 'sessionrestore', 10:12:47 INFO - 'sessionrestore_no_auto_restore', 10:12:47 INFO - 'tabpaint']}, 10:12:47 INFO - 'other-e10s': {'tests': ['a11yr', 10:12:47 INFO - 'ts_paint', 10:12:47 INFO - 'tpaint', 10:12:47 INFO - 'sessionrestore', 10:12:47 INFO - 'sessionrestore_no_auto_restore', 10:12:47 INFO - 'tabpaint']}, 10:12:47 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:12:47 INFO - 'ts_paint', 10:12:47 INFO - 'tpaint', 10:12:47 INFO - 'sessionrestore', 10:12:47 INFO - 'sessionrestore_no_auto_restore', 10:12:47 INFO - 'tabpaint']}, 10:12:47 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:12:47 INFO - 'ts_paint', 10:12:47 INFO - 'tpaint', 10:12:47 INFO - 'sessionrestore', 10:12:47 INFO - 'sessionrestore_no_auto_restore', 10:12:47 INFO - 'tabpaint']}, 10:12:47 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['a11yr', 10:12:47 INFO - 'ts_paint', 10:12:47 INFO - 'tpaint', 10:12:47 INFO - 'sessionrestore', 10:12:47 INFO - 'sessionrestore_no_auto_restore', 10:12:47 INFO - 'tabpaint']}, 10:12:47 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['a11yr', 10:12:47 INFO - 'ts_paint', 10:12:47 INFO - 'tpaint', 10:12:47 INFO - 'sessionrestore', 10:12:47 INFO - 'sessionrestore_no_auto_restore', 10:12:47 INFO - 'tabpaint']}, 10:12:47 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['tsvgx', 10:12:47 INFO - 'tsvgr_opacity', 10:12:47 INFO - 'tart', 10:12:47 INFO - 'tscrollx', 10:12:47 INFO - 'cart', 10:12:47 INFO - 'tsvg_static']}, 10:12:47 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:12:47 INFO - 'tsvgr_opacity', 10:12:47 INFO - 'tart', 10:12:47 INFO - 'tscrollx', 10:12:47 INFO - 'cart', 10:12:47 INFO - 'tsvg_static']}, 10:12:47 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 10:12:47 INFO - 'talos_options': ['--disable-e10s'], 10:12:47 INFO - 'tests': ['tp5o']}, 10:12:47 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 10:12:47 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 10:12:47 INFO - 'talos_options': ['--disable-e10s', 10:12:47 INFO - '--xperf_path', 10:12:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:12:47 INFO - 'tests': ['tp5n']}, 10:12:47 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 10:12:47 INFO - 'talos_options': ['--xperf_path', 10:12:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:12:47 INFO - 'tests': ['tp5n']}}, 10:12:47 INFO - 'talos.zip': {'path': '', 10:12:47 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:12:47 INFO - Running post-action listener: _resource_record_post_action 10:12:47 INFO - [mozharness: 2017-03-02 18:12:47.043824Z] Finished populate-webroot step (success) 10:12:47 INFO - [mozharness: 2017-03-02 18:12:47.043960Z] Running create-virtualenv step. 10:12:47 INFO - Running pre-action listener: _resource_record_pre_action 10:12:47 INFO - Running main action method: create_virtualenv 10:12:47 INFO - Creating virtualenv /builds/slave/test/build/venv 10:12:47 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 10:12:47 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:12:47 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:12:47 INFO - Using real prefix '/tools/python27' 10:12:47 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:12:47 INFO - Installing distribute.............................................................................................................................................................................................done. 10:12:50 INFO - Installing pip.................done. 10:12:50 INFO - Return code: 0 10:12:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 10:12:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 10:12:50 INFO - Reading from file tmpfile_stdout 10:12:50 INFO - Output received: 10:12:50 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) 10:12:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:12:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:12:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:12:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:12:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:12:51 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:12:51 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 10:12:51 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 10:12:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:12:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:12:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:12:51 INFO - 'HOME': '/Users/cltbld', 10:12:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:12:51 INFO - 'LOGNAME': 'cltbld', 10:12:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:12:51 INFO - 'MOZ_NO_REMOTE': '1', 10:12:51 INFO - 'NO_EM_RESTART': '1', 10:12:51 INFO - 'PAGER': '/bin/cat', 10:12:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:12:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:12:51 INFO - 'PWD': '/builds/slave/test', 10:12:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:12:51 INFO - 'SHELL': '/bin/bash', 10:12:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:12:51 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:12:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:12:51 INFO - 'USER': 'cltbld', 10:12:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:12:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:12:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:12:51 INFO - 'XPC_FLAGS': '0x0', 10:12:51 INFO - 'XPC_SERVICE_NAME': '0', 10:12:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:12:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:12:51 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 10:12:51 INFO - Cleaning up... 10:12:51 INFO - Return code: 0 10:12:51 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:12:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:12:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:12:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:12:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:12:51 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:12:51 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 10:12:51 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 10:12:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:12:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:12:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:12:51 INFO - 'HOME': '/Users/cltbld', 10:12:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:12:51 INFO - 'LOGNAME': 'cltbld', 10:12:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:12:51 INFO - 'MOZ_NO_REMOTE': '1', 10:12:51 INFO - 'NO_EM_RESTART': '1', 10:12:51 INFO - 'PAGER': '/bin/cat', 10:12:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:12:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:12:51 INFO - 'PWD': '/builds/slave/test', 10:12:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:12:51 INFO - 'SHELL': '/bin/bash', 10:12:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:12:51 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:12:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:12:51 INFO - 'USER': 'cltbld', 10:12:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:12:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:12:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:12:51 INFO - 'XPC_FLAGS': '0x0', 10:12:51 INFO - 'XPC_SERVICE_NAME': '0', 10:12:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:12:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:12:51 INFO - Downloading/unpacking psutil>=3.1.1 10:12:51 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 10:12:51 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 10:12:51 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 10:12:51 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 10:12:51 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 10:12:51 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 10:12:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:12:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:12:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:12:55 INFO - Installing collected packages: psutil 10:12:55 INFO - Running setup.py install for psutil 10:12:55 INFO - building 'psutil._psutil_osx' extension 10:12:55 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 10:12:55 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 10:12:55 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 10:12:55 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 10:12:55 INFO - building 'psutil._psutil_posix' extension 10:12:55 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 10:12:55 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 10:12:55 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 10:12:55 INFO - ^ 10:12:55 INFO - 1 warning generated. 10:12:55 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 10:12:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:12:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:12:56 INFO - Successfully installed psutil 10:12:56 INFO - Cleaning up... 10:12:56 INFO - Return code: 0 10:12:56 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:12:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:12:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:12:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:12:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:12:56 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:12:56 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 10:12:56 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 10:12:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:12:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:12:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:12:56 INFO - 'HOME': '/Users/cltbld', 10:12:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:12:56 INFO - 'LOGNAME': 'cltbld', 10:12:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:12:56 INFO - 'MOZ_NO_REMOTE': '1', 10:12:56 INFO - 'NO_EM_RESTART': '1', 10:12:56 INFO - 'PAGER': '/bin/cat', 10:12:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:12:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:12:56 INFO - 'PWD': '/builds/slave/test', 10:12:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:12:56 INFO - 'SHELL': '/bin/bash', 10:12:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:12:56 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:12:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:12:56 INFO - 'USER': 'cltbld', 10:12:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:12:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:12:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:12:56 INFO - 'XPC_FLAGS': '0x0', 10:12:56 INFO - 'XPC_SERVICE_NAME': '0', 10:12:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:12:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:12:56 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:12:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:12:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:12:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:12:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:12:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:12:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:12:59 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:12:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:12:59 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:12:59 INFO - Installing collected packages: mozsystemmonitor 10:12:59 INFO - Running setup.py install for mozsystemmonitor 10:12:59 INFO - Successfully installed mozsystemmonitor 10:12:59 INFO - Cleaning up... 10:12:59 INFO - Return code: 0 10:12:59 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:12:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:12:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:12:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:12:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:12:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:00 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:13:00 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 10:13:00 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 10:13:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:13:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:13:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:13:00 INFO - 'HOME': '/Users/cltbld', 10:13:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:13:00 INFO - 'LOGNAME': 'cltbld', 10:13:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:00 INFO - 'MOZ_NO_REMOTE': '1', 10:13:00 INFO - 'NO_EM_RESTART': '1', 10:13:00 INFO - 'PAGER': '/bin/cat', 10:13:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:13:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:00 INFO - 'PWD': '/builds/slave/test', 10:13:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:13:00 INFO - 'SHELL': '/bin/bash', 10:13:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:13:00 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:13:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:13:00 INFO - 'USER': 'cltbld', 10:13:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:13:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:13:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:00 INFO - 'XPC_FLAGS': '0x0', 10:13:00 INFO - 'XPC_SERVICE_NAME': '0', 10:13:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:13:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:00 INFO - Downloading/unpacking jsonschema==2.5.1 10:13:00 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 10:13:00 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 10:13:00 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 10:13:00 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 10:13:00 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 10:13:00 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 10:13:03 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:13:03 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:13:03 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 10:13:03 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 10:13:03 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 10:13:03 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 10:13:03 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 10:13:03 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 10:13:03 INFO - Downloading functools32-3.2.3-2.tar.gz 10:13:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:13:03 INFO - warning: no files found matching '*.txt' 10:13:03 INFO - no previously-included directories found matching 'build' 10:13:03 INFO - no previously-included directories found matching 'dist' 10:13:03 INFO - no previously-included directories found matching '.git*' 10:13:03 INFO - Installing collected packages: jsonschema, functools32 10:13:03 INFO - Running setup.py install for functools32 10:13:04 INFO - warning: no files found matching '*.txt' 10:13:04 INFO - no previously-included directories found matching 'build' 10:13:04 INFO - no previously-included directories found matching 'dist' 10:13:04 INFO - no previously-included directories found matching '.git*' 10:13:04 INFO - Successfully installed jsonschema functools32 10:13:04 INFO - Cleaning up... 10:13:04 INFO - Return code: 0 10:13:04 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 10:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:13:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:13:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:04 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:13:04 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 10:13:04 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 10:13:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:13:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:13:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:13:04 INFO - 'HOME': '/Users/cltbld', 10:13:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:13:04 INFO - 'LOGNAME': 'cltbld', 10:13:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:04 INFO - 'MOZ_NO_REMOTE': '1', 10:13:04 INFO - 'NO_EM_RESTART': '1', 10:13:04 INFO - 'PAGER': '/bin/cat', 10:13:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:13:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:04 INFO - 'PWD': '/builds/slave/test', 10:13:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:13:04 INFO - 'SHELL': '/bin/bash', 10:13:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:13:04 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:13:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:13:04 INFO - 'USER': 'cltbld', 10:13:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:13:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:13:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:04 INFO - 'XPC_FLAGS': '0x0', 10:13:04 INFO - 'XPC_SERVICE_NAME': '0', 10:13:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:13:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:04 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 10:13:04 INFO - Cleaning up... 10:13:04 INFO - Return code: 0 10:13:04 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:13:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:13:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:04 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:13:04 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 10:13:04 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 10:13:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:13:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:13:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:13:04 INFO - 'HOME': '/Users/cltbld', 10:13:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:13:04 INFO - 'LOGNAME': 'cltbld', 10:13:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:04 INFO - 'MOZ_NO_REMOTE': '1', 10:13:04 INFO - 'NO_EM_RESTART': '1', 10:13:04 INFO - 'PAGER': '/bin/cat', 10:13:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:13:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:04 INFO - 'PWD': '/builds/slave/test', 10:13:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:13:04 INFO - 'SHELL': '/bin/bash', 10:13:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:13:04 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:13:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:13:04 INFO - 'USER': 'cltbld', 10:13:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:13:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:13:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:04 INFO - 'XPC_FLAGS': '0x0', 10:13:04 INFO - 'XPC_SERVICE_NAME': '0', 10:13:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:13:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:04 INFO - Downloading/unpacking blobuploader==1.2.4 10:13:04 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 10:13:04 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 10:13:04 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 10:13:04 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 10:13:04 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 10:13:04 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 10:13:07 INFO - Downloading blobuploader-1.2.4.tar.gz 10:13:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:13:07 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:13: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 10:13: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 10:13: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 10:13: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 10:13: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 10:13: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 10:13:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:13:08 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:13:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:08 INFO - Downloading docopt-0.6.1.tar.gz 10:13:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:13:08 INFO - Installing collected packages: blobuploader, requests, docopt 10:13:08 INFO - Running setup.py install for blobuploader 10:13:08 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:13:08 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:13:08 INFO - Running setup.py install for requests 10:13:09 INFO - Running setup.py install for docopt 10:13:09 INFO - Successfully installed blobuploader requests docopt 10:13:09 INFO - Cleaning up... 10:13:09 INFO - Return code: 0 10:13:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:13:09 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')]} 10:13:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:09 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')]} 10:13:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:09 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:13:09 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 10:13:09 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 10:13:09 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:13:09 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:13:09 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:13:09 INFO - 'HOME': '/Users/cltbld', 10:13:09 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:13:09 INFO - 'LOGNAME': 'cltbld', 10:13:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:09 INFO - 'MOZ_NO_REMOTE': '1', 10:13:09 INFO - 'NO_EM_RESTART': '1', 10:13:09 INFO - 'PAGER': '/bin/cat', 10:13:09 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:13:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:09 INFO - 'PWD': '/builds/slave/test', 10:13:09 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:13:09 INFO - 'SHELL': '/bin/bash', 10:13:09 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:13:09 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:13:09 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:13:09 INFO - 'USER': 'cltbld', 10:13:09 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:13:09 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:13:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:09 INFO - 'XPC_FLAGS': '0x0', 10:13:09 INFO - 'XPC_SERVICE_NAME': '0', 10:13:09 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:13:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:13:09 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-YGZdJq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:13:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:13:09 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-JHSsDg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-uZXl3X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-5QatsS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-kPx5Ja-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-YDc1j3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-srxe6t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-pagOBe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-gGwzN0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-zwSlfV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:13:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:13:10 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-tN45C1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:13:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:13:11 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-s9by4E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:13:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:13:11 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-BVQ6J_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:13:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:13:11 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-NbuUxe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:13:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:13:11 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-g5KJM7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:13:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:13:11 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-OynStC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:13:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:13:11 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-KP0HLo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:13:11 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:13:11 INFO - Running setup.py install for manifestparser 10:13:11 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:13:11 INFO - Running setup.py install for mozcrash 10:13:11 INFO - Running setup.py install for mozdebug 10:13:12 INFO - Running setup.py install for mozdevice 10:13:12 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:13:12 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:13:12 INFO - Running setup.py install for mozfile 10:13:12 INFO - Running setup.py install for mozhttpd 10:13:12 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:13:12 INFO - Running setup.py install for mozinfo 10:13:12 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:13:12 INFO - Running setup.py install for mozInstall 10:13:12 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:13:12 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:13:12 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:13:12 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:13:12 INFO - Running setup.py install for mozleak 10:13:12 INFO - Running setup.py install for mozlog 10:13:13 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:13:13 INFO - Running setup.py install for moznetwork 10:13:13 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:13:13 INFO - Running setup.py install for mozprocess 10:13:13 INFO - Running setup.py install for mozprofile 10:13:13 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:13:13 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:13:13 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:13:13 INFO - Running setup.py install for mozrunner 10:13:13 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:13:13 INFO - Running setup.py install for mozscreenshot 10:13:13 INFO - Running setup.py install for moztest 10:13:14 INFO - Running setup.py install for mozversion 10:13:14 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:13:14 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:13:14 INFO - Cleaning up... 10:13:14 INFO - Return code: 0 10:13:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:13:14 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')]} 10:13:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:14 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')]} 10:13:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:14 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:13:14 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 10:13:14 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 10:13:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:13:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:13:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:13:14 INFO - 'HOME': '/Users/cltbld', 10:13:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:13:14 INFO - 'LOGNAME': 'cltbld', 10:13:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:14 INFO - 'MOZ_NO_REMOTE': '1', 10:13:14 INFO - 'NO_EM_RESTART': '1', 10:13:14 INFO - 'PAGER': '/bin/cat', 10:13:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:13:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:14 INFO - 'PWD': '/builds/slave/test', 10:13:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:13:14 INFO - 'SHELL': '/bin/bash', 10:13:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:13:14 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:13:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:13:14 INFO - 'USER': 'cltbld', 10:13:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:13:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:13:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:14 INFO - 'XPC_FLAGS': '0x0', 10:13:14 INFO - 'XPC_SERVICE_NAME': '0', 10:13:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:13:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:13:14 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-2UkxwG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:13:14 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)) 10:13:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:13:14 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-iv6CXX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:13:14 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)) 10:13:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:13:14 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-jH8ATk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:13:14 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)) 10:13:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:13:14 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-bPLA7z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:13:14 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)) 10:13:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:13:14 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-FmJbk4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:13:15 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-8Qu3OL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:13:15 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-V6LvsM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:13:15 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-Q_n_a3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:13:15 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-UfVfI3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:13:15 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-vKlsHb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:13:15 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-9rwmbT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:13:15 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-oJ4Klw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:13:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-fszz5J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:13:15 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)) 10:13:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:13:15 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-s2kphC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:13:16 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)) 10:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:13:16 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-ONfmQ2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:13:16 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)) 10:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:13:16 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-zdX4fv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:13:16 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)) 10:13:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:13:16 INFO - Running setup.py (path:/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/pip-CHubsb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:13:16 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)) 10:13:16 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)) 10:13:16 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)) 10:13:16 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)) 10:13:16 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)) 10:13:16 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)) 10:13:16 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:13:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:18 INFO - Downloading blessings-1.6.tar.gz 10:13:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:13:19 INFO - Installing collected packages: blessings 10:13:19 INFO - Running setup.py install for blessings 10:13:19 INFO - Successfully installed blessings 10:13:19 INFO - Cleaning up... 10:13:19 INFO - Return code: 0 10:13:19 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:13:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:13:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:13:19 INFO - Reading from file tmpfile_stdout 10:13:19 INFO - Current package versions: 10:13:19 INFO - blessings == 1.6 10:13:19 INFO - blobuploader == 1.2.4 10:13:19 INFO - docopt == 0.6.1 10:13:19 INFO - functools32 == 3.2.3-2 10:13:19 INFO - jsonschema == 2.5.1 10:13:19 INFO - manifestparser == 1.1 10:13:19 INFO - mozInstall == 1.12 10:13:19 INFO - mozcrash == 1.0 10:13:19 INFO - mozdebug == 0.1 10:13:19 INFO - mozdevice == 0.49 10:13:19 INFO - mozfile == 1.2 10:13:19 INFO - mozhttpd == 0.7 10:13:19 INFO - mozinfo == 0.9 10:13:19 INFO - mozleak == 0.1 10:13:19 INFO - mozlog == 3.4 10:13:19 INFO - moznetwork == 0.27 10:13:19 INFO - mozprocess == 0.25 10:13:19 INFO - mozprofile == 0.28 10:13:19 INFO - mozrunner == 6.13 10:13:19 INFO - mozscreenshot == 0.1 10:13:19 INFO - mozsystemmonitor == 0.3 10:13:19 INFO - moztest == 0.8 10:13:19 INFO - mozversion == 1.4 10:13:19 INFO - psutil == 3.1.1 10:13:19 INFO - requests == 1.2.3 10:13:19 INFO - wsgiref == 0.1.2 10:13:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:13: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')]} 10:13:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13: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')]} 10:13:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:19 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 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:13:19 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 10:13:19 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 10:13:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:13:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:13:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:13:19 INFO - 'HOME': '/Users/cltbld', 10:13:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:13:19 INFO - 'LOGNAME': 'cltbld', 10:13:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:19 INFO - 'MOZ_NO_REMOTE': '1', 10:13:19 INFO - 'NO_EM_RESTART': '1', 10:13:19 INFO - 'PAGER': '/bin/cat', 10:13:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:13:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:19 INFO - 'PWD': '/builds/slave/test', 10:13:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:13:19 INFO - 'SHELL': '/bin/bash', 10:13:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:13:19 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:13:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:13:19 INFO - 'USER': 'cltbld', 10:13:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:13:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:13:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:19 INFO - 'XPC_FLAGS': '0x0', 10:13:19 INFO - 'XPC_SERVICE_NAME': '0', 10:13:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:13:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 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)) 10:13:19 INFO - Cleaning up... 10:13:19 INFO - Return code: 0 10:13:19 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:13: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')]} 10:13:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13: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')]} 10:13:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106c6ab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106c6d768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe0abdbe0d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, '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.QcXlEKos6J/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.XXpfBEumK3/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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 10:13: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', 'jsonschema'] in /builds/slave/test/build 10:13: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 jsonschema 10:13:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:13:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:13:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:13:19 INFO - 'HOME': '/Users/cltbld', 10:13:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:13:19 INFO - 'LOGNAME': 'cltbld', 10:13:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:19 INFO - 'MOZ_NO_REMOTE': '1', 10:13:19 INFO - 'NO_EM_RESTART': '1', 10:13:19 INFO - 'PAGER': '/bin/cat', 10:13:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:13:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:19 INFO - 'PWD': '/builds/slave/test', 10:13:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:13:19 INFO - 'SHELL': '/bin/bash', 10:13:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:13:19 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:13:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:13:19 INFO - 'USER': 'cltbld', 10:13:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:13:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:13:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:19 INFO - 'XPC_FLAGS': '0x0', 10:13:19 INFO - 'XPC_SERVICE_NAME': '0', 10:13:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:13:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:20 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:13:20 INFO - Cleaning up... 10:13:20 INFO - Return code: 0 10:13:20 INFO - Running post-action listener: _resource_record_post_action 10:13:20 INFO - Running post-action listener: _start_resource_monitoring 10:13:20 INFO - Starting resource monitoring. 10:13:20 INFO - [mozharness: 2017-03-02 18:13:20.138404Z] Finished create-virtualenv step (success) 10:13:20 INFO - [mozharness: 2017-03-02 18:13:20.139374Z] Running install step. 10:13:20 INFO - Running pre-action listener: _resource_record_pre_action 10:13:20 INFO - Running main action method: install 10:13:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:13:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:13:20 INFO - Reading from file tmpfile_stdout 10:13:20 INFO - Detecting whether we're running mozinstall >=1.0... 10:13:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:13:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:13:20 INFO - Reading from file tmpfile_stdout 10:13:20 INFO - Output received: 10:13:20 INFO - Usage: mozinstall [options] installer 10:13:20 INFO - Options: 10:13:20 INFO - -h, --help show this help message and exit 10:13:20 INFO - -d DEST, --destination=DEST 10:13:20 INFO - Directory to install application into. [default: 10:13:20 INFO - "/builds/slave/test"] 10:13:20 INFO - --app=APP Application being installed. [default: firefox] 10:13:20 INFO - mkdir: /builds/slave/test/build/application 10:13:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-54.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 10:13:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-54.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 10:13:40 INFO - Reading from file tmpfile_stdout 10:13:40 INFO - Output received: 10:13:40 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 10:13:40 INFO - Running post-action listener: _resource_record_post_action 10:13:40 INFO - [mozharness: 2017-03-02 18:13:40.939229Z] Finished install step (success) 10:13:40 INFO - [mozharness: 2017-03-02 18:13:40.939393Z] Running run-tests step. 10:13:40 INFO - Running pre-action listener: _resource_record_pre_action 10:13:40 INFO - Running main action method: run_tests 10:13:40 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:13:40 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:13:40 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:13:40 INFO - 2017-03-02 10:13:40.954 screenresolution[1966:277818] starting screenresolution argv=screenresolution get 10:13:40 INFO - 2017-03-02 10:13:40.957 screenresolution[1966:277818] Display 0: 1600x1200x32@60 10:13:40 INFO - 2017-03-02 10:13:40.962 screenresolution[1967:277820] starting screenresolution argv=screenresolution list 10:13:40 INFO - Available Modes on Display 0 10:13:40 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:13:40 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:13:40 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:13:40 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:13:41 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:13:41 INFO - Intel Iris: 10:13:41 INFO - Chipset Model: Intel Iris 10:13:41 INFO - Type: GPU 10:13:41 INFO - Bus: Built-In 10:13:41 INFO - VRAM (Dynamic, Max): 1536 MB 10:13:41 INFO - Vendor: Intel (0x8086) 10:13:41 INFO - Device ID: 0x0a2e 10:13:41 INFO - Revision ID: 0x0009 10:13:41 INFO - Displays: 10:13:41 INFO - Display: 10:13:41 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:13:41 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:13:41 INFO - Display Serial Number: 1600x1200 60 10:13:41 INFO - Main Display: Yes 10:13:41 INFO - Mirror: Off 10:13:41 INFO - Online: Yes 10:13:41 INFO - Rotation: Supported 10:13:41 INFO - Return code: 0 10:13:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:13:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:13:41 INFO - Python 2.7.3 10:13:41 INFO - Return code: 0 10:13:41 INFO - grabbing minidump binary from tooltool 10:13:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:13:41 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 0x106a48d30>, '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 0x10696fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106a3dbe8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:13:41 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 10:13:41 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 10:13:41 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 10:13:41 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:13:41 INFO - Return code: 0 10:13:41 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 10:13:41 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:13:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:13:41 INFO - ENV: RUST_BACKTRACE is now 1 10:13:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 10:13:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:13:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0265', '--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 10:13:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0265 --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 10:13:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.QcXlEKos6J/Render', 10:13:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:13:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:13:41 INFO - 'HOME': '/Users/cltbld', 10:13:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:13:41 INFO - 'LOGNAME': 'cltbld', 10:13:41 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:13:41 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 10:13:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:41 INFO - 'MOZ_NO_REMOTE': '1', 10:13:41 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:13:41 INFO - 'NO_EM_RESTART': '1', 10:13:41 INFO - 'PAGER': '/bin/cat', 10:13:41 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:13:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:41 INFO - 'PWD': '/builds/slave/test', 10:13:41 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:13:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:13:41 INFO - 'RUST_BACKTRACE': '1', 10:13:41 INFO - 'SHELL': '/bin/bash', 10:13:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.XXpfBEumK3/Listeners', 10:13:41 INFO - 'TMPDIR': '/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/', 10:13:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:13:41 INFO - 'USER': 'cltbld', 10:13:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:13:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:13:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:41 INFO - 'XPC_FLAGS': '0x0', 10:13:41 INFO - 'XPC_SERVICE_NAME': '0', 10:13:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:13:41 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0265', '--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 10:13:41 INFO - mozversion application_buildid: 20170302074351 10:13:41 INFO - mozversion application_changeset: d29f84406483c721a13cf9a52936ecced0c5c98a 10:13:41 INFO - mozversion application_display_name: Nightly 10:13:41 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:13:41 INFO - mozversion application_name: Firefox 10:13:41 INFO - mozversion application_remotingname: firefox 10:13:41 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 10:13:41 INFO - mozversion application_vendor: Mozilla 10:13:41 INFO - mozversion application_version: 54.0a1 10:13:41 INFO - mozversion platform_buildid: 20170302074351 10:13:41 INFO - mozversion platform_changeset: d29f84406483c721a13cf9a52936ecced0c5c98a 10:13:41 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 10:13:41 INFO - mozversion platform_version: 54.0a1 10:13:41 INFO - using testdate: 1488478421 10:13:41 INFO - actual date: 1488478421 10:13:41 INFO - starting webserver on 'localhost:49309' 10:13:41 INFO - SUITE-START | Running 2 tests 10:13:41 INFO - TEST-START | dromaeo_css 10:13:41 INFO - operating with platform_type : mac_ 10:13:41 INFO - Initialising browser for dromaeo_css test... 10:13:41 INFO - TEST-INFO | started process 1977 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/tmpsxp29u/profile http://localhost:49309/getInfo.html) 10:13:44 INFO - PROCESS | 1977 | __metrics Screen width/height:1600/1200 10:13:44 INFO - PROCESS | 1977 | colorDepth:24 10:13:44 INFO - PROCESS | 1977 | Browser inner width/height: 1024/689 10:13:44 INFO - PROCESS | 1977 | __metrics 10:13:44 INFO - PROCESS | 1977 | 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" 10:13:44 INFO - PROCESS | 1977 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:13:44 INFO - TEST-INFO | 1977: exit 0 10:13:44 INFO - Browser initialized. 10:13:44 INFO - Running cycle 1/1 for dromaeo_css test... 10:13:44 INFO - TEST-INFO | started process 1981 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/tmpsxp29u/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:13:57 INFO - PROCESS | 1981 | RSS: Main: 232366080 10:13:57 INFO - PROCESS | 1981 | 10:17:01 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:49309/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49309/tests/dromaeo/cssquery-ext.html) 10:17:03 INFO - PROCESS | 1981 | RSS: Main: 377823232 10:17:03 INFO - PROCESS | 1981 | 10:18:46 INFO - PROCESS | 1981 | ************************* 10:18:46 INFO - PROCESS | 1981 | A coding exception was thrown and uncaught in a Task. 10:18:46 INFO - PROCESS | 1981 | 10:18:46 ERROR - PROCESS | 1981 | Full message: TypeError: NetworkError when attempting to fetch resource. 10:18:46 INFO - PROCESS | 1981 | Full stack: 10:18:46 INFO - PROCESS | 1981 | ************************* 10:20:06 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:49309/tests/dromaeo/cssquery-ext.html (next: http://localhost:49309/tests/dromaeo/cssquery-jquery.html) 10:20:07 INFO - PROCESS | 1981 | RSS: Main: 365518848 10:20:07 INFO - PROCESS | 1981 | 10:23:10 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:49309/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49309/tests/dromaeo/cssquery-mootools.html) 10:23:10 INFO - PROCESS | 1981 | RSS: Main: 350232576 10:23:10 INFO - PROCESS | 1981 | 10:26:13 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:49309/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49309/tests/dromaeo/cssquery-prototype.html) 10:26:13 INFO - PROCESS | 1981 | RSS: Main: 339537920 10:26:13 INFO - PROCESS | 1981 | 10:29:17 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:49309/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49309/tests/dromaeo/cssquery-yui.html) 10:29:17 INFO - PROCESS | 1981 | RSS: Main: 345772032 10:29:17 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | Cycle 1(1): loaded http://localhost:49309/tests/dromaeo/cssquery-yui.html (next: http://localhost:49309/tests/dromaeo/cssquery-dojo.html) 10:32:21 INFO - PROCESS | 1981 | RSS: Main: 569692160 10:32:21 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | __start_tp_report 10:32:21 INFO - PROCESS | 1981 | _x_x_mozilla_page_load 10:32:21 INFO - PROCESS | 1981 | _x_x_mozilla_page_load_details 10:32:21 INFO - PROCESS | 1981 | |i|pagename|runs| 10:32:21 INFO - PROCESS | 1981 | |0;dojo.html;3329.5338652588657;3344.9163770905734;3344.9331013379747;3353.5137405076257;3373.713234375078;5524.917126243109;5607.046802043652;5642.15367694846;5758.02113640681;5774.884502309957;5583.58123140764;5637.436256374361;5644.266245388104;5644.407337229593;5645.040343141665;5133.281340612308;5149.716765577892;5181.3264275644115;5184.766685499161;5195.168772996321;5123.257127716479;5123.2827404163445;5126.487351264881;5133.948660513384;5143.3570803649545;5119.897602047976;5122.8207012754565;5123.052235336475;5135.64050516464;5138.948610513903;5093.490650934914;5110.591152707774;5114.156164232934;5117.104506711348;5124.692518448905;5010.4739002404585;5062.519060689228;5067.543921047123;5067.797288108508;5098.107831129574;5694.145878118274;5811.215485909391;5821.970890145564;5824.679642619654;5831.037878750001;6125.877482450326;6285.308616052231;6299.6850157491945;6327.082573026932;6332.651704156269;6210.844728881769;6215.502759779207;6284.18305620271;6299.8740025199695;6311.589746666452;5217;5744.3394009689;5794.652320860761;5879.206307148565;5986.760529578768;6314.55798094129;6334.429901308812;6338.904916426257;6340.270868850142;6358.682065896686;6247.531435142382;6251.593646412968;6254.249490061222;6266.248050234001;6271.686415679198;6145.631262124287;6184.474319682788;6210.192674952227;6266.49868010558;6314.55798094129;6247.281562620356;6272.8118156455375;6289.811305660837;6298.055291706189;6302.1492098566105;6327.525435592349;6327.905081423783;6342.112104305401;6344.555881088372;6344.841378965562;4902.0441014002645;4917.434495033117;4972.975135124301;5040.344755181803;5094.821681241138;4477.440319960005;4479.126570318822;4482.522754619608;4492.146492166478;4529.5243999380245;5761.971190144022;5764.135379692996;5765.596408251466;5769;5794.188813566104;4527.705699129546;6141.959729933622;6202.751889924442;6249.281332646713;6326.841828954313;4820.9517904821205;5777.45114214149;5800;5823.213866128103;5845.766169353264;5487.067198576252;5493.093639549509;5497.202905578669;5503.229547863222;5507;6261.749530018748;6268.435840774352;6276.309605943251;6381.138546296191;6386.425221730066;6263.874722505616;6312.084747711464;6327.11420401135;6338.207724034496;6339.080833279241;6332.651704156131;6391.488680905423;6393.360663933569;6403.199600049994;6407.0709747085475;6029.547783916311;6107.037103281215;6277.71750271248;6300.684965751786;6304.905426418699;6231.875362492634;6243.875122497434;6284.780032698834;6324.936750632435;6326.082718005955;6167.876642467215;6191.349908259568;6197.977333739883;6204.286507051566;6213.596116252429;5924.555658325729;5946.940530594812;6003.249593800775;6181.629102253879;6201.906971395342;5840.795572154954;5958.076498142795;6054.576179667381;6066.7269972850445;6079.696015199311;6188;6189.783357582463;6211.192544969125;6216.191895053795;6224.657643829632;5776.682282474504;6017.578769486094;6028.186194863637;6036.8188954331445;6088.634681919099 10:32:21 INFO - PROCESS | 1981 | |1;ext.html;674.905513228148;724.5471580262337;785.9410544209184;846.1158089796158;859.4628357276702;22121.889390553046;28911.421771564557;28987.85506072472;29029.41941161181;29067.563986540194;28061.438771224563;40723.18553628925;41330.58669413305;41365.75902722923;43107.49123780661;8885;9031.322650801183;9044.145950080218;9053;9059.909400906006;8935.910640893606;9046.86429703555;9073.183413492785;9078.092190780935;9083.909160908372;7257.673404696801;7420.33217010469;10921.617743378984;11138.053265472405;11165.995060444558;10975.725606859813;11011;11026.834597481044;11039.227254092217;11039.448027598628;10729.570817167303;10804.5678172873;10814.891851081467;10820.404877731722;10827.729306767395;27131.91472341104;27552.173434796987;27667.861660691568;28418.72115754796;28495;2771;3749.6812770914503;3772.1324095457926;3851.4607954886337;3964.623360780721;23133;23206.65190022151;27703.722962770316;27904;28528.286792830346;2606.4396154826804;2830.8584570771377;2954.9261268468244;3153.7477001839798;3163.7469002479747;354057;354717;354943;356288;356713.9999999974;49834;49880.750596246784;49924;49994.250086248736;50057.49827505181;55015.724921375135;55245.723771380886;55270.44729552734;55304;55366.44633553613;13727.382267797973;13811.171329720048;13820.032597718064;13820.930895345458;13823.861761382257;11821.527138914518;11827.586034488751;11836.993855522376;11840.993515551274;11843.407829608484;10670.30643008202;11906.583269585522;12515.937420312841;12583.93708031454;12797.232166070065;4852.126617208865;5663.122216056518;5726.885462290731;5756.683382414008;5789;897.4525539420948;990.3612170150212;1047.2864184686937;1100.7743412600398;1111.366291551418;26017.869910650705;26441;26562.734372656414;26585.73414265871;26737.866310668713;1184.5025089462447;1192.1357016163386;1197.6706405738491;1246.6571692784557;1249.7812882745484;12192.268463892195;13165.712918469513;13209.933950330187;13261.801072983913;13380.6654833628;465097;465785;465923;466168;467204;55541.722291389095;55570.72214638982;55605.165922511194;55612.72193639006;55655;1348.7235116801032;1391.9930400348137;1398.4336343780785;1399.3632897031825;1409.8519655436032;23950.8973908046;24626.384340391633;24631;24973.87513062423;25089.87455062713;46480.7675961618;46682.83292917704;46721;46728;46805.29792053054;354976;355720;356802;356939;358006;23863.880680596485;23927.880360598087;23978;23985.76014239905;24061.51876962416;39015.414768777926;39989.2002159961;40085;41544.792276038424;42101.36847947344;31170.532442012933;31445.213869653442;32889.17777055593;33537.832310839265;33848.3230335387;32276.83861580677;32468.75312468734;32965.84619538401;33422.665773341956;34120.14699632529;32662.51006234956;32881.50677739788;32974;33567.160820978694;33934.151646208054;27934.30164245829;29028;29220;29338.706612933598;29830;20925.056390696678;22483.10067597278;22502.66246006344;22599.435014124778;22834.429139270986 10:32:21 INFO - PROCESS | 1981 | |2;jquery.html;332.8618623271343;369.4255432801993;371.2222893039082;389.38671592242207;432.16591977483444;13367.665808354795;13631.522896698618;20492.89753551234;21060;21867.12531498738;21620.459488512795;21663.025163867624;22764.88617556914;22846.657300140512;23062.423439414022;6239.875202495959;6487.967560162193;6520.347965203466;6534.281229064799;6536.444402225793;6093.299270583873;6439.227292724856;6489.383508566679;6494.512911531654;6497.22033355998;6400.51996100292;6428.164338635971;6498;6498.317676643956;6505.316941721122;6319.368063193667;6494.837629059264;6502.089707440962;6504.544681872271;6509.381608747209;6210.875782484371;6233.781817636406;6291.961826298655;6320.336364681688;6328.1773369462135;26441.074562390415;26800.525971071584;26852.925882964657;27024.919003239847;27145.45709085827;2842.8152170109083;2897.3774686175807;2901.7968742188054;2919.168037109435;2933.809302395359;14222.786658200135;15634.921825390915;15883;16416.671666566723;16968.15159242033;1662.9750553741703;1963.391348681899;1984.4145976936838;2002.5994801039851;2082.250389859649;127122.36438817746;131295;133636;136349;136535;15599.376024958874;15760.68478630421;19311.903440482707;19502.8049719501;19566.315178968667;24950.625740613905;25755.356116097246;25760.613590796154;28132;29218.707812922024;9588.232941364675;9927.950360248153;9967.903530611628;10025.899741002642;10154.898451015542;5372.3184123653855;7046.260142684944;7380.188179300273;7405.259474052552;7477.327040566266;8174.264316211569;9102.362834601514;9202.953985230031;9210.95394523023;9211.355205135576;3171.9073902944447;3702.33357995558;3762.155268611536;3785.883164466489;3804.8668296609485;739.4638886807129;775.8681024225782;784.9254320839511;784.9529028258208;799.7520768561765;20797.89601051985;21294.935253237276;21807.563848722937;21871.343859684235;21877.890610546845;970.6699722094522;1008.68226508651;1046.7226185060965;1058.1059005140644;1069.844872493484;10536.209784266211;10651.429026113867;11092.722681932855;11107;11126.443677816076;553973;689601;696103;705942;716170;130963;161051;162596;167867.1606641959;170487.14756426387;986.506746626701;1022.9488525573692;1042;1048.051513380392;1051.5951358726945;17992.550186245448;18539.073046347898;18596.628067438305;18612.627747445247;18686.34597789071;56891.43108569027;57023.71488142533;61615;62953.37046629658;63647.363526365996;89184.87160030374;89672;91285;91870.54064729634;93229;10880.510377032893;11258;11493.195476316578;11629.360385178557;11704.239224450725;12388.938055309665;12560.550692614852;12588.370581471074;12646;12750.362481876055;9556.856647150438;10664.733381665521;11157.776844462904;11275.718107047389;11320.37737924422;9937.304388693012;9998.500074996367;10544.578216871547;10680.786384272116;10887.673369798918;5812.680302583399;8099.271065604124;8507.744767656981;11334.716632084264;11613;9348.813023739624;11031.558737650725;11079.944600276947;11365.886341136484;11421.714457138305;10805.729856753644;10972.286801357886;11009.504572294427;11085.113190944867;11144.108471322437 10:32:21 INFO - PROCESS | 1981 | |3;mootools.html;1415.1721243072802;1451;1498.4830233569428;1556.2374436526102;1561.2427972433372;10401;10995.34027958323;11008.174386920973;11013.339199648006;11020.559177632895;10262.74343141422;10692.305000174983;10714.982076702701;10822.891771082286;10837.512311945962;2296.7358753743283;2335.9532809343805;2337.9883100584475;2338.754430784769;2339.438534751656;2252.0991603358625;2318.1770471482632;2353.8352315337847;2354.9411264718347;2357.5167090746354;1909.93043895419;2046.4270004398793;2296.8277379196543;2321.1179751694417;2325.476767727265;2288.7711228877147;2296.7818057284617;2315.3517015235593;2321.6749655048307;2328.9650655240102;2265.626171681687;2341.356127065054;2346.120204923154;2349.3304408243566;2349.4713689419746;10725.78548429027;10803.513841877057;10815.83776243357;10823.13414926804;10824.350538967687;5667.886642267132;5850.122481627747;5859.589828711949;5863.58954873159;5870.09013602888;3320.9169770755684;3461.197792464402;3574.4995700601935;3615.5299811024397;3620.8732694355836;1147.7073346296725;1161.9883801161964;1173.718307606177;1184.3190165654783;1213.071999920062;13644.93177534106;13972.72054558903;14012.859871401359;15139.394424223017;15140.470083547023;3221.7261532769508;4330.133973205371;4338.891527711769;4341.34879768031;4341.522432532419;11222.270552414067;11534.538618455335;11560.537578496935;11703.941480292715;11742.354170520532;5440.401555828856;5536.474034966672;5536.640118392372;5543.417941116206;5545.9722701387045;4823.1800593899125;4880.170371036861;4928.186849169847;5207.29701490294;5284.471552844761;3364.5457863188158;3681.171736359298;3748.662620364126;3820.4269359596283;3887.436321733333;1019.4851599942131;1026.0919086608405;1028.3983869436313;1039.0648416425279;1039.7608550033535;834.7036801935348;869.4609342207872;875.2691502595277;911.9270458363447;925.0518218825757;6364.299927008025;6417.197850268716;6641.501887358468;6697.296783837627;6746.494012949049;861.8793368928355;973.9805203896024;978.295627148452;981.215027977615;1035.7048241251207;3951.9604803951593;4006.419069234945;4092.9795351023054;4129.525104613008;4153.875383738493;12977.41601627929;13307.933460332637;13397.330133493286;13414.329283535784;13436.320459942508;13206.386377844097;13320.467181312833;13322.600321990356;13342;13363.331833408485;9627.470489123025;10088.192944564416;10090.747731306776;10111.443870587189;10114.494275286206;5439.9456005441025;6218.160548325918;6355;6407.487401008001;6428.710708018057;11934.761304774029;12102.36618056551;12109.939450302692;12116.27302361861;12122.454489547816;8321.459105158388;9187.908120918706;9290.210332121846;11678.70803229892;11695.76608467809;7455.552666840007;7623.847523049619;7625.123110842324;7636.618169091635;7650.808729781577;8981.461112333282;9124.27005839518;9402.482863442576;9989.400635961865;10026.047525485068;8734.126587341216;8888.555572221492;8913.465192088495;9071.501067441353;9115.453072815651;8711.041785403473;8720.040795512616;8726.91273087261;8783.429077109968;8851.424657397507;7481.251874812475;7657.157712651492;7658.349040331412;7660.770176894702;7663.195364486649;5593.356763972032;5727.570432217683;5814.592978491465;5836.124581312837;5863.560232982458;4576.222042252892;4902.950970490249;5092.821751238837;5651.15232715096;5813.738381772915 10:32:21 INFO - PROCESS | 1981 | |4;prototype.html;370.5849448617547;371.7063519819343;376.69111328710466;382.3404627018394;383.5914750790407;4273.401723758676;4643.953560464394;5153.458886816887;5298.258243845865;5304.787808487661;4305.397244385781;4307.913841723163;4911.926321105187;5201.895962080756;5212.76542555585;3769.8501956903065;3884.533855937277;4327.826886924519;4397.164538737646;4404.317330813713;4376.496702879162;4404.216292401583;4420.6242469390145;4423.623991960687;4443.422355093833;4394.582514661102;4400.911981760363;4439.4672639283335;4449.065696203785;4450.954025803933;3529.894103176883;3741.289155060543;3965.7422267552515;4362.847300344504;4392.011797345572;3372.274960883422;3719.9628003719886;3907.902302442462;4074.5110586729484;4104.281750693646;4784.569388755029;4884.853454396374;5111.875387414762;5199.660152931158;5238.947610523922;4862.343583616202;5110.821121260738;5117.923231151536;5148.073346797575;5154.664946778485;4456.866294011184;5517.834464966058;5521.889562208733;5553.194786755938;5567.635929197332;4498.437695288089;4499.75251361175;4521.932171017437;4525.796339164745;4580.862574122782;4802.871325238566;5392.946070539323;5664.971675141598;5864.765409383662;5869.857502011778;4367.540574282148;4397.0546332538015;4595.356650068993;4610.331501932201;4701.341812146302;4039.7576145431367;4219.641330486882;4438.844640437569;4541.6593755468475;4798.592119669867;4227.239096962577;4873.926891096637;5037.0681423936685;5099.796008159632;5133.974330128325;5174.741262936838;5235.424103348629;5595.300587426572;5601.29983752031;5607.8598035048635;1475.4098360655823;1531.9199964025336;1533.8696210822204;1554.2772610736063;1558.6648870492897;1027.5684212630713;1049.5486940615456;1124.9043831274432;1146.2721172055637;1147.0422197465043;4520.819167233274;4535.546445355504;4546.658735672984;4819.638527110481;5044.571211446994;5033.974830125826;5104.783986088814;5274.525292723597;5628.380878103405;5634.971825140848;3849.557300910431;4956.589898102288;4985.501449855058;5037.748112594356;5061.8228362007885;2586.754258345492;2587.826225970194;2906.4858897053896;2923.298408381973;2927.5654929084594;5053.873653158627;5207.036698210767;5268.7091662542925;5443.924182836685;5504.697241651667;4802.89352603519;4974.030064137531;5044.419891712427;5203.19350500673;5690.012743309712;5057.570106540985;5778.971105144531;5779.739911703983;5790.88418231633;5806.796762113306;5019.62352823547;5206.791728330824;5305.5248812028185;5380.865478363072;5443.891122177455;4438.467383913951;4852.514748525119;4913.9017219656125;5405.918911216414;5506.807261745819;5329.973350133225;5442.945570544244;5676.801311954062;5761.884762304814;5779.971100144472;3614.819259036985;3861.980690096644;4435.756033418063;4477.783497168923;4496.865094047183;5166.767495462638;5261.974139956068;5540.418256083214;5558.471945165203;5596.776128954796;4579.58033009768;4742.928856067093;4780.856574302777;5361.249425080414;5386.811461598825;4262.46719160105;4906.460289368238;5040.823571174991;5182.53357197854;5413.1880217966045;4418.624416924597;4577.954220457753;5294.523492885659;5296.364436267672;5311.44229855875;4976.925346119883;5023.271625614192;5379.488948549882;5424.891502170013;5430.429804870431;4641.559051890065;4748.955229849427;4823.011282687111;5187.19598462239;5532.197831314517 10:32:21 INFO - PROCESS | 1981 | |5;yui.html;714.4570126703703;723.4284914917216;727.7271023366237;757.3184134279148;868.0581568997637;14815.407383704653;15496.922515387407;15497.53507394777;15515.612109697264;15526.844731552681;13728.382222799974;14052;14092.57722268331;14227;14237.71524569508;750.6246876561719;942.4627962061628;944.0936700767254;961.889382720989;961.9519024048805;955.7706150523859;957.4829592020335;958.3195930889077;960.5149399553216;961.1157734883924;946.2619157057471;990.2226751999682;993.9861341431736;997.725625452999;1027.6043723166597;986.5412583148799;986.541258314887;987.5950860147341;987.7431867714374;987.8073775613758;718.7520305494596;719.8704233238016;721.7690339091492;721.8087206890178;722.7253643615445;14573.854261457356;14580;14612.926935365362;14697.926510367486;15520.146391948438;13881.236531990737;14189.503367382194;14192.219427931459;14195.148291102567;14195.432182712679;10826.621068262652;11343;11461.598844040418;11526;12175.0868684849;3745.763897913682;4320.092780516095;4367.519572846984;4395.494518130424;4506.143832671782;96488.51755741246;97239.51380243053;98425.50787246018;99758.50120749422;100129.4980575292;10311.07200351972;10312.123469505026;10657;10658.467076646137;10760.085392741705;20318.59362812765;20667.196187450416;20870.37388878336;20874.791252087587;20877.895610522155;7285.198628150899;7307.7807665770115;7313;7350.926490735131;7372.483926125227;4083.1017176221185;4115.164979349611;4166.0834616384345;4170.416141740159;4188.204241194163;3242.951355729666;3304.752143589192;3326.6340702522702;3334.549835772188;3340.816255105944;519.6674128557726;599.7164976556551;600.9158717779427;617.0312609203597;620.7610070123035;512.869218349326;521.2884412776533;532.6085327284443;534.5883669574406;536.7209051293383;6573.441257493167;7703.460757746904;9050.87094220103;9421.623135074657;9584.329096963145;592.280379339105;620.3362402229571;650.4958657040831;651.1892693596408;659.1134923527848;4464.352668862996;4605.562471565196;4622.2835460503675;4679.766011699401;4684.718916864931;97546;99547.50678739825;99904;100299.49850250702;102529;48547.75726121347;67405.66297168582;69233.2691682712;72084.27915720775;77399;72418.63790681119;73722;73808.89286660704;74277.02891884481;74900.5019899599;10478.423686697;10514.684559463229;10711.517981690999;10749.62376316825;10761.838572421264;46332.7683361581;46399.76800115978;47008.05983880372;47263.52736472729;47740.7612961933;57319.99380021679;58391.95628152994;60373;60410.69794650999;61291;12179.75640487203;12292.139550231397;12340.444679989243;12532.185407948455;12663.873361266638;13874.236916969663;13905.652358691113;13937.30313484342;13973.231472269123;14003.439862405798;13051.474262868565;13157.737204429583;13206;13344.933275333562;13387.866121338662;10820.56717731282;13044.02169837247;13154.21074735519;13442.327883605585;13575.796363054365;12910.160839545399;13000;13087.934560327138;13120.803187951997;13765.449382025008;10525.315854469434;10804.783904322027;10842.945785271024;10876.456177191267;11621.6513504595;8844.46933184011;9059.788233420864;10451.16390688728;10662.786744265226;10671.786564268827 10:32:21 INFO - PROCESS | 1981 | __end_tp_report 10:32:21 INFO - PROCESS | 1981 | __start_cc_report 10:32:21 INFO - PROCESS | 1981 | _x_x_mozilla_cycle_collect,1601 10:32:21 INFO - PROCESS | 1981 | __end_cc_report 10:32:21 INFO - PROCESS | 1981 | __startTimestamp1488479541357__endTimestamp 10:32:21 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | ------- Summary: start ------- 10:32:21 INFO - PROCESS | 1981 | Number of tests: 6 10:32:21 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | [#0] dojo.html Cycles:165 Average:5755.61 Median:6017.58 stddev:675.64 (11.2%) stddev-sans-first:650.35 10:32:21 INFO - PROCESS | 1981 | Values: 3329.5 3344.9 3344.9 3353.5 3373.7 5524.9 5607.0 5642.2 5758.0 5774.9 5583.6 5637.4 5644.3 5644.4 5645.0 5133.3 5149.7 5181.3 5184.8 5195.2 5123.3 5123.3 5126.5 5133.9 5143.4 5119.9 5122.8 5123.1 5135.6 5138.9 5093.5 5110.6 5114.2 5117.1 5124.7 5010.5 5062.5 5067.5 5067.8 5098.1 5694.1 5811.2 5822.0 5824.7 5831.0 6125.9 6285.3 6299.7 6327.1 6332.7 6210.8 6215.5 6284.2 6299.9 6311.6 5217.0 5744.3 5794.7 5879.2 5986.8 6314.6 6334.4 6338.9 6340.3 6358.7 6247.5 6251.6 6254.2 6266.2 6271.7 6145.6 6184.5 6210.2 6266.5 6314.6 6247.3 6272.8 6289.8 6298.1 6302.1 6327.5 6327.9 6342.1 6344.6 6344.8 4902.0 4917.4 4973.0 5040.3 5094.8 4477.4 4479.1 4482.5 4492.1 4529.5 5762.0 5764.1 5765.6 5769.0 5794.2 4527.7 6142.0 6202.8 6249.3 6326.8 4821.0 5777.5 5800.0 5823.2 5845.8 5487.1 5493.1 5497.2 5503.2 5507.0 6261.7 6268.4 6276.3 6381.1 6386.4 6263.9 6312.1 6327.1 6338.2 6339.1 6332.7 6391.5 6393.4 6403.2 6407.1 6029.5 6107.0 6277.7 6300.7 6304.9 6231.9 6243.9 6284.8 6324.9 6326.1 6167.9 6191.3 6198.0 6204.3 6213.6 5924.6 5946.9 6003.2 6181.6 6201.9 5840.8 5958.1 6054.6 6066.7 6079.7 6188.0 6189.8 6211.2 6216.2 6224.7 5776.7 6017.6 6028.2 6036.8 6088.6 10:32:21 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | [#1] ext.html Cycles:180 Average:52455.11 Median:30500.27 stddev:105095.53 (344.6%) stddev-sans-first:105318.44 10:32:21 INFO - PROCESS | 1981 | Values: 674.9 724.5 785.9 846.1 859.5 22121.9 28911.4 28987.9 29029.4 29067.6 28061.4 40723.2 41330.6 41365.8 43107.5 8885.0 9031.3 9044.1 9053.0 9059.9 8935.9 9046.9 9073.2 9078.1 9083.9 7257.7 7420.3 10921.6 11138.1 11166.0 10975.7 11011.0 11026.8 11039.2 11039.4 10729.6 10804.6 10814.9 10820.4 10827.7 27131.9 27552.2 27667.9 28418.7 28495.0 2771.0 3749.7 3772.1 3851.5 3964.6 23133.0 23206.7 27703.7 27904.0 28528.3 2606.4 2830.9 2954.9 3153.7 3163.7 354057.0 354717.0 354943.0 356288.0 356714.0 49834.0 49880.8 49924.0 49994.3 50057.5 55015.7 55245.7 55270.4 55304.0 55366.4 13727.4 13811.2 13820.0 13820.9 13823.9 11821.5 11827.6 11837.0 11841.0 11843.4 10670.3 11906.6 12515.9 12583.9 12797.2 4852.1 5663.1 5726.9 5756.7 5789.0 897.5 990.4 1047.3 1100.8 1111.4 26017.9 26441.0 26562.7 26585.7 26737.9 1184.5 1192.1 1197.7 1246.7 1249.8 12192.3 13165.7 13209.9 13261.8 13380.7 465097.0 465785.0 465923.0 466168.0 467204.0 55541.7 55570.7 55605.2 55612.7 55655.0 1348.7 1392.0 1398.4 1399.4 1409.9 23950.9 24626.4 24631.0 24973.9 25089.9 46480.8 46682.8 46721.0 46728.0 46805.3 354976.0 355720.0 356802.0 356939.0 358006.0 23863.9 23927.9 23978.0 23985.8 24061.5 39015.4 39989.2 40085.0 41544.8 42101.4 31170.5 31445.2 32889.2 33537.8 33848.3 32276.8 32468.8 32965.8 33422.7 34120.1 32662.5 32881.5 32974.0 33567.2 33934.2 27934.3 29028.0 29220.0 29338.7 29830.0 20925.1 22483.1 22502.7 22599.4 22834.4 10:32:21 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | [#2] jquery.html Cycles:180 Average:39998.13 Median:26100.84 stddev:113125.50 (433.4%) stddev-sans-first:113403.64 10:32:21 INFO - PROCESS | 1981 | Values: 332.9 369.4 371.2 389.4 432.2 13367.7 13631.5 20492.9 21060.0 21867.1 21620.5 21663.0 22764.9 22846.7 23062.4 6239.9 6488.0 6520.3 6534.3 6536.4 6093.3 6439.2 6489.4 6494.5 6497.2 6400.5 6428.2 6498.0 6498.3 6505.3 6319.4 6494.8 6502.1 6504.5 6509.4 6210.9 6233.8 6292.0 6320.3 6328.2 26441.1 26800.5 26852.9 27024.9 27145.5 2842.8 2897.4 2901.8 2919.2 2933.8 14222.8 15634.9 15883.0 16416.7 16968.2 1663.0 1963.4 1984.4 2002.6 2082.3 127122.4 131295.0 133636.0 136349.0 136535.0 15599.4 15760.7 19311.9 19502.8 19566.3 24950.6 25755.4 25760.6 28132.0 29218.7 9588.2 9928.0 9967.9 10025.9 10154.9 5372.3 7046.3 7380.2 7405.3 7477.3 8174.3 9102.4 9203.0 9211.0 9211.4 3171.9 3702.3 3762.2 3785.9 3804.9 739.5 775.9 784.9 785.0 799.8 20797.9 21294.9 21807.6 21871.3 21877.9 970.7 1008.7 1046.7 1058.1 1069.8 10536.2 10651.4 11092.7 11107.0 11126.4 553973.0 689601.0 696103.0 705942.0 716170.0 130963.0 161051.0 162596.0 167867.2 170487.1 986.5 1022.9 1042.0 1048.1 1051.6 17992.6 18539.1 18596.6 18612.6 18686.3 56891.4 57023.7 61615.0 62953.4 63647.4 89184.9 89672.0 91285.0 91870.5 93229.0 10880.5 11258.0 11493.2 11629.4 11704.2 12388.9 12560.6 12588.4 12646.0 12750.4 9556.9 10664.7 11157.8 11275.7 11320.4 9937.3 9998.5 10544.6 10680.8 10887.7 5812.7 8099.3 8507.7 11334.7 11613.0 9348.8 11031.6 11079.9 11365.9 11421.7 10805.7 10972.3 11009.5 11085.1 11144.1 10:32:21 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | [#3] mootools.html Cycles:180 Average:6443.61 Median:3412.87 stddev:4043.83 (118.5%) stddev-sans-first:4037.52 10:32:21 INFO - PROCESS | 1981 | Values: 1415.2 1451.0 1498.5 1556.2 1561.2 10401.0 10995.3 11008.2 11013.3 11020.6 10262.7 10692.3 10715.0 10822.9 10837.5 2296.7 2336.0 2338.0 2338.8 2339.4 2252.1 2318.2 2353.8 2354.9 2357.5 1909.9 2046.4 2296.8 2321.1 2325.5 2288.8 2296.8 2315.4 2321.7 2329.0 2265.6 2341.4 2346.1 2349.3 2349.5 10725.8 10803.5 10815.8 10823.1 10824.4 5667.9 5850.1 5859.6 5863.6 5870.1 3320.9 3461.2 3574.5 3615.5 3620.9 1147.7 1162.0 1173.7 1184.3 1213.1 13644.9 13972.7 14012.9 15139.4 15140.5 3221.7 4330.1 4338.9 4341.3 4341.5 11222.3 11534.5 11560.5 11703.9 11742.4 5440.4 5536.5 5536.6 5543.4 5546.0 4823.2 4880.2 4928.2 5207.3 5284.5 3364.5 3681.2 3748.7 3820.4 3887.4 1019.5 1026.1 1028.4 1039.1 1039.8 834.7 869.5 875.3 911.9 925.1 6364.3 6417.2 6641.5 6697.3 6746.5 861.9 974.0 978.3 981.2 1035.7 3952.0 4006.4 4093.0 4129.5 4153.9 12977.4 13307.9 13397.3 13414.3 13436.3 13206.4 13320.5 13322.6 13342.0 13363.3 9627.5 10088.2 10090.7 10111.4 10114.5 5439.9 6218.2 6355.0 6407.5 6428.7 11934.8 12102.4 12109.9 12116.3 12122.5 8321.5 9187.9 9290.2 11678.7 11695.8 7455.6 7623.8 7625.1 7636.6 7650.8 8981.5 9124.3 9402.5 9989.4 10026.0 8734.1 8888.6 8913.5 9071.5 9115.5 8711.0 8720.0 8726.9 8783.4 8851.4 7481.3 7657.2 7658.3 7660.8 7663.2 5593.4 5727.6 5814.6 5836.1 5863.6 4576.2 4903.0 5092.8 5651.2 5813.7 10:32:21 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | [#4] prototype.html Cycles:180 Average:4517.39 Median:4868.14 stddev:1241.44 (25.5%) stddev-sans-first:1205.27 10:32:21 INFO - PROCESS | 1981 | Values: 370.6 371.7 376.7 382.3 383.6 4273.4 4644.0 5153.5 5298.3 5304.8 4305.4 4307.9 4911.9 5201.9 5212.8 3769.9 3884.5 4327.8 4397.2 4404.3 4376.5 4404.2 4420.6 4423.6 4443.4 4394.6 4400.9 4439.5 4449.1 4451.0 3529.9 3741.3 3965.7 4362.8 4392.0 3372.3 3720.0 3907.9 4074.5 4104.3 4784.6 4884.9 5111.9 5199.7 5238.9 4862.3 5110.8 5117.9 5148.1 5154.7 4456.9 5517.8 5521.9 5553.2 5567.6 4498.4 4499.8 4521.9 4525.8 4580.9 4802.9 5392.9 5665.0 5864.8 5869.9 4367.5 4397.1 4595.4 4610.3 4701.3 4039.8 4219.6 4438.8 4541.7 4798.6 4227.2 4873.9 5037.1 5099.8 5134.0 5174.7 5235.4 5595.3 5601.3 5607.9 1475.4 1531.9 1533.9 1554.3 1558.7 1027.6 1049.5 1124.9 1146.3 1147.0 4520.8 4535.5 4546.7 4819.6 5044.6 5034.0 5104.8 5274.5 5628.4 5635.0 3849.6 4956.6 4985.5 5037.7 5061.8 2586.8 2587.8 2906.5 2923.3 2927.6 5053.9 5207.0 5268.7 5443.9 5504.7 4802.9 4974.0 5044.4 5203.2 5690.0 5057.6 5779.0 5779.7 5790.9 5806.8 5019.6 5206.8 5305.5 5380.9 5443.9 4438.5 4852.5 4913.9 5405.9 5506.8 5330.0 5442.9 5676.8 5761.9 5780.0 3614.8 3862.0 4435.8 4477.8 4496.9 5166.8 5262.0 5540.4 5558.5 5596.8 4579.6 4742.9 4780.9 5361.2 5386.8 4262.5 4906.5 5040.8 5182.5 5413.2 4418.6 4578.0 5294.5 5296.4 5311.4 4976.9 5023.3 5379.5 5424.9 5430.4 4641.6 4749.0 4823.0 5187.2 5532.2 10:32:21 INFO - PROCESS | 1981 | 10:32:21 INFO - PROCESS | 1981 | [#5] yui.html Cycles:180 Average:18972.51 Median:4429.92 stddev:26648.87 (601.6%) stddev-sans-first:26688.36 10:32:21 INFO - PROCESS | 1981 | Values: 714.5 723.4 727.7 757.3 868.1 14815.4 15496.9 15497.5 15515.6 15526.8 13728.4 14052.0 14092.6 14227.0 14237.7 750.6 942.5 944.1 961.9 962.0 955.8 957.5 958.3 960.5 961.1 946.3 990.2 994.0 997.7 1027.6 986.5 986.5 987.6 987.7 987.8 718.8 719.9 721.8 721.8 722.7 14573.9 14580.0 14612.9 14697.9 15520.1 13881.2 14189.5 14192.2 14195.1 14195.4 10826.6 11343.0 11461.6 11526.0 12175.1 3745.8 4320.1 4367.5 4395.5 4506.1 96488.5 97239.5 98425.5 99758.5 100129.5 10311.1 10312.1 10657.0 10658.5 10760.1 20318.6 20667.2 20870.4 20874.8 20877.9 7285.2 7307.8 7313.0 7350.9 7372.5 4083.1 4115.2 4166.1 4170.4 4188.2 3243.0 3304.8 3326.6 3334.5 3340.8 519.7 599.7 600.9 617.0 620.8 512.9 521.3 532.6 534.6 536.7 6573.4 7703.5 9050.9 9421.6 9584.3 592.3 620.3 650.5 651.2 659.1 4464.4 4605.6 4622.3 4679.8 4684.7 97546.0 99547.5 99904.0 100299.5 102529.0 48547.8 67405.7 69233.3 72084.3 77399.0 72418.6 73722.0 73808.9 74277.0 74900.5 10478.4 10514.7 10711.5 10749.6 10761.8 46332.8 46399.8 47008.1 47263.5 47740.8 57320.0 58392.0 60373.0 60410.7 61291.0 12179.8 12292.1 12340.4 12532.2 12663.9 13874.2 13905.7 13937.3 13973.2 14003.4 13051.5 13157.7 13206.0 13344.9 13387.9 10820.6 13044.0 13154.2 13442.3 13575.8 12910.2 13000.0 13087.9 13120.8 13765.4 10525.3 10804.8 10842.9 10876.5 11621.7 8844.5 9059.8 10451.2 10662.8 10671.8 10:32:21 INFO - PROCESS | 1981 | -------- Summary: end -------- 10:32:21 INFO - PROCESS | 1981 | 10:32:22 INFO - TEST-INFO | 1981: exit 0 10:32:22 INFO - TEST-OK | dromaeo_css | took 1120517ms 10:32:22 INFO - TEST-START | kraken 10:32:22 INFO - operating with platform_type : mac_ 10:32:22 INFO - Initialising browser for kraken test... 10:32:22 INFO - TEST-INFO | started process 1986 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/tmp23xA0a/profile http://localhost:49309/getInfo.html) 10:32:24 INFO - PROCESS | 1986 | __metrics Screen width/height:1600/1200 10:32:24 INFO - PROCESS | 1986 | colorDepth:24 10:32:24 INFO - PROCESS | 1986 | Browser inner width/height: 1024/689 10:32:24 INFO - PROCESS | 1986 | __metrics 10:32:24 INFO - PROCESS | 1986 | 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" 10:32:24 INFO - PROCESS | 1986 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:32:25 INFO - TEST-INFO | 1986: exit 0 10:32:25 INFO - Browser initialized. 10:32:25 INFO - Running cycle 1/1 for kraken test... 10:32:25 INFO - TEST-INFO | started process 1987 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/T/tmp23xA0a/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:32:37 INFO - PROCESS | 1987 | RSS: Main: 232497152 10:32:37 INFO - PROCESS | 1987 | 10:32:40 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49309/tests/kraken/driver.html?testName=audio-beat-detection) 10:32:41 INFO - PROCESS | 1987 | RSS: Main: 284065792 10:32:41 INFO - PROCESS | 1987 | 10:32:44 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49309/tests/kraken/driver.html?testName=audio-dft) 10:32:44 INFO - PROCESS | 1987 | RSS: Main: 286171136 10:32:44 INFO - PROCESS | 1987 | 10:32:48 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49309/tests/kraken/driver.html?testName=audio-fft) 10:32:48 INFO - PROCESS | 1987 | RSS: Main: 376205312 10:32:48 INFO - PROCESS | 1987 | 10:32:50 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49309/tests/kraken/driver.html?testName=audio-oscillator) 10:32:51 INFO - PROCESS | 1987 | RSS: Main: 279277568 10:32:51 INFO - PROCESS | 1987 | 10:32:53 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49309/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:32:54 INFO - PROCESS | 1987 | RSS: Main: 281985024 10:32:54 INFO - PROCESS | 1987 | 10:32:57 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49309/tests/kraken/driver.html?testName=imaging-darkroom) 10:32:57 INFO - PROCESS | 1987 | RSS: Main: 324771840 10:32:57 INFO - PROCESS | 1987 | 10:33:00 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49309/tests/kraken/driver.html?testName=imaging-desaturate) 10:33:01 INFO - PROCESS | 1987 | RSS: Main: 328794112 10:33:01 INFO - PROCESS | 1987 | 10:33:04 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49309/tests/kraken/driver.html?testName=json-parse-financial) 10:33:05 INFO - PROCESS | 1987 | RSS: Main: 325599232 10:33:05 INFO - PROCESS | 1987 | 10:33:07 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49309/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:33:07 INFO - PROCESS | 1987 | RSS: Main: 301477888 10:33:07 INFO - PROCESS | 1987 | 10:33:09 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49309/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:33:10 INFO - PROCESS | 1987 | RSS: Main: 307920896 10:33:10 INFO - PROCESS | 1987 | 10:33:12 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49309/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:33:13 INFO - PROCESS | 1987 | RSS: Main: 308408320 10:33:13 INFO - PROCESS | 1987 | 10:33:16 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49309/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:33:17 INFO - PROCESS | 1987 | RSS: Main: 322613248 10:33:17 INFO - PROCESS | 1987 | 10:33:19 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49309/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:33:20 INFO - PROCESS | 1987 | RSS: Main: 317370368 10:33:20 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | Cycle 1(1): loaded http://localhost:49309/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49309/tests/kraken/driver.html?testName=ai-astar) 10:33:22 INFO - PROCESS | 1987 | RSS: Main: 362459136 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | __start_tp_report 10:33:22 INFO - PROCESS | 1987 | _x_x_mozilla_page_load 10:33:22 INFO - PROCESS | 1987 | _x_x_mozilla_page_load_details 10:33:22 INFO - PROCESS | 1987 | |i|pagename|runs| 10:33:22 INFO - PROCESS | 1987 | |0;ai-astar;116;117;117;115;117;116;117;117;116;117 10:33:22 INFO - PROCESS | 1987 | |1;audio-beat-detection;143;135;143;168;107;109;109;98;148;114 10:33:22 INFO - PROCESS | 1987 | |2;audio-dft;180;181;185;186;192;180;185;184;182;183 10:33:22 INFO - PROCESS | 1987 | |3;audio-fft;83;59;61;89;64;60;60;61;76;62 10:33:22 INFO - PROCESS | 1987 | |4;audio-oscillator;91;70;86;70;70;68;84;71;68;85 10:33:22 INFO - PROCESS | 1987 | |5;imaging-gaussian-blur;90;89;90;89;89;89;89;89;90;89 10:33:22 INFO - PROCESS | 1987 | |6;imaging-darkroom;96;97;96;96;97;96;96;96;97;97 10:33:22 INFO - PROCESS | 1987 | |7;imaging-desaturate;83;72;123;69;132;129;103;85;86;85 10:33:22 INFO - PROCESS | 1987 | |8;json-parse-financial;63;63;60;60;61;61;65;64;64;63 10:33:22 INFO - PROCESS | 1987 | |9;json-stringify-tinderbox;54;62;65;62;61;57;58;59;58;58 10:33:22 INFO - PROCESS | 1987 | |10;stanford-crypto-aes;87;89;109;107;107;77;96;108;109;100 10:33:22 INFO - PROCESS | 1987 | |11;stanford-crypto-ccm;144;157;169;146;153;139;142;142;183;141 10:33:22 INFO - PROCESS | 1987 | |12;stanford-crypto-pbkdf2;174;172;175;174;171;170;172;170;172;172 10:33:22 INFO - PROCESS | 1987 | |13;stanford-crypto-sha256-iterative;67;68;68;67;65;69;66;78;59;61 10:33:22 INFO - PROCESS | 1987 | __end_tp_report 10:33:22 INFO - PROCESS | 1987 | __start_cc_report 10:33:22 INFO - PROCESS | 1987 | _x_x_mozilla_cycle_collect,2122 10:33:22 INFO - PROCESS | 1987 | __end_cc_report 10:33:22 INFO - PROCESS | 1987 | __startTimestamp1488479602585__endTimestamp 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | ------- Summary: start ------- 10:33:22 INFO - PROCESS | 1987 | Number of tests: 14 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#0] ai-astar Cycles:10 Average:116.50 Median:117.00 stddev:0.71 (0.6%) stddev-sans-first:0.73 10:33:22 INFO - PROCESS | 1987 | Values: 116.0 117.0 117.0 115.0 117.0 116.0 117.0 117.0 116.0 117.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#1] audio-beat-detection Cycles:10 Average:127.40 Median:143.00 stddev:22.98 (16.1%) stddev-sans-first:23.67 10:33:22 INFO - PROCESS | 1987 | Values: 143.0 135.0 143.0 168.0 107.0 109.0 109.0 98.0 148.0 114.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#2] audio-dft Cycles:10 Average:183.80 Median:184.50 stddev:3.58 (1.9%) stddev-sans-first:3.53 10:33:22 INFO - PROCESS | 1987 | Values: 180.0 181.0 185.0 186.0 192.0 180.0 185.0 184.0 182.0 183.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#3] audio-fft Cycles:10 Average:67.50 Median:63.00 stddev:10.99 (17.4%) stddev-sans-first:10.12 10:33:22 INFO - PROCESS | 1987 | Values: 83.0 59.0 61.0 89.0 64.0 60.0 60.0 61.0 76.0 62.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#4] audio-oscillator Cycles:10 Average:76.30 Median:77.50 stddev:9.01 (11.6%) stddev-sans-first:7.83 10:33:22 INFO - PROCESS | 1987 | Values: 91.0 70.0 86.0 70.0 70.0 68.0 84.0 71.0 68.0 85.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#5] imaging-gaussian-blur Cycles:10 Average:89.30 Median:89.00 stddev:0.48 (0.5%) stddev-sans-first:0.44 10:33:22 INFO - PROCESS | 1987 | Values: 90.0 89.0 90.0 89.0 89.0 89.0 89.0 89.0 90.0 89.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#6] imaging-darkroom Cycles:10 Average:96.40 Median:96.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 10:33:22 INFO - PROCESS | 1987 | Values: 96.0 97.0 96.0 96.0 97.0 96.0 96.0 96.0 97.0 97.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#7] imaging-desaturate Cycles:10 Average:96.70 Median:77.50 stddev:23.51 (30.3%) stddev-sans-first:24.41 10:33:22 INFO - PROCESS | 1987 | Values: 83.0 72.0 123.0 69.0 132.0 129.0 103.0 85.0 86.0 85.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#8] json-parse-financial Cycles:10 Average:62.40 Median:63.00 stddev:1.78 (2.8%) stddev-sans-first:1.87 10:33:22 INFO - PROCESS | 1987 | Values: 63.0 63.0 60.0 60.0 61.0 61.0 65.0 64.0 64.0 63.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#9] json-stringify-tinderbox Cycles:10 Average:59.40 Median:60.00 stddev:3.13 (5.2%) stddev-sans-first:2.65 10:33:22 INFO - PROCESS | 1987 | Values: 54.0 62.0 65.0 62.0 61.0 57.0 58.0 59.0 58.0 58.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#10] stanford-crypto-aes Cycles:10 Average:98.90 Median:93.00 stddev:11.29 (12.1%) stddev-sans-first:11.12 10:33:22 INFO - PROCESS | 1987 | Values: 87.0 89.0 109.0 107.0 107.0 77.0 96.0 108.0 109.0 100.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#11] stanford-crypto-ccm Cycles:10 Average:151.60 Median:149.50 stddev:14.39 (9.6%) stddev-sans-first:15.00 10:33:22 INFO - PROCESS | 1987 | Values: 144.0 157.0 169.0 146.0 153.0 139.0 142.0 142.0 183.0 141.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:172.20 Median:172.00 stddev:1.69 (1.0%) stddev-sans-first:1.66 10:33:22 INFO - PROCESS | 1987 | Values: 174.0 172.0 175.0 174.0 171.0 170.0 172.0 170.0 172.0 172.0 10:33:22 INFO - PROCESS | 1987 | 10:33:22 INFO - PROCESS | 1987 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.80 Median:67.50 stddev:5.07 (7.5%) stddev-sans-first:5.38 10:33:22 INFO - PROCESS | 1987 | Values: 67.0 68.0 68.0 67.0 65.0 69.0 66.0 78.0 59.0 61.0 10:33:22 INFO - PROCESS | 1987 | -------- Summary: end -------- 10:33:22 INFO - PROCESS | 1987 | 10:33:23 INFO - TEST-INFO | 1987: exit 0 10:33:23 INFO - TEST-OK | kraken | took 61744ms 10:33:23 INFO - SUITE-END | took 1182s 10:33:24 INFO - Completed test suite (00:19:42) 10:33:24 INFO - javascript benchmark 10:33:24 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7400.128871778678, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3329.5338652588657, 3344.9163770905734, 3344.9331013379747, 3353.5137405076257, 3373.713234375078, 5524.917126243109, 5607.046802043652, 5642.15367694846, 5758.02113640681, 5774.884502309957, 5583.58123140764, 5637.436256374361, 5644.266245388104, 5644.407337229593, 5645.040343141665, 5133.281340612308, 5149.716765577892, 5181.3264275644115, 5184.766685499161, 5195.168772996321, 5123.257127716479, 5123.2827404163445, 5126.487351264881, 5133.948660513384, 5143.3570803649545, 5119.897602047976, 5122.8207012754565, 5123.052235336475, 5135.64050516464, 5138.948610513903, 5093.490650934914, 5110.591152707774, 5114.156164232934, 5117.104506711348, 5124.692518448905, 5010.4739002404585, 5062.519060689228, 5067.543921047123, 5067.797288108508, 5098.107831129574, 5694.145878118274, 5811.215485909391, 5821.970890145564, 5824.679642619654, 5831.037878750001, 6125.877482450326, 6285.308616052231, 6299.6850157491945, 6327.082573026932, 6332.651704156269, 6210.844728881769, 6215.502759779207, 6284.18305620271, 6299.8740025199695, 6311.589746666452, 5217.0, 5744.3394009689, 5794.652320860761, 5879.206307148565, 5986.760529578768, 6314.55798094129, 6334.429901308812, 6338.904916426257, 6340.270868850142, 6358.682065896686, 6247.531435142382, 6251.593646412968, 6254.249490061222, 6266.248050234001, 6271.686415679198, 6145.631262124287, 6184.474319682788, 6210.192674952227, 6266.49868010558, 6314.55798094129, 6247.281562620356, 6272.8118156455375, 6289.811305660837, 6298.055291706189, 6302.1492098566105, 6327.525435592349, 6327.905081423783, 6342.112104305401, 6344.555881088372, 6344.841378965562, 4902.0441014002645, 4917.434495033117, 4972.975135124301, 5040.344755181803, 5094.821681241138, 4477.440319960005, 4479.126570318822, 4482.522754619608, 4492.146492166478, 4529.5243999380245, 5761.971190144022, 5764.135379692996, 5765.596408251466, 5769.0, 5794.188813566104, 4527.705699129546, 6141.959729933622, 6202.751889924442, 6249.281332646713, 6326.841828954313, 4820.9517904821205, 5777.45114214149, 5800.0, 5823.213866128103, 5845.766169353264, 5487.067198576252, 5493.093639549509, 5497.202905578669, 5503.229547863222, 5507.0, 6261.749530018748, 6268.435840774352, 6276.309605943251, 6381.138546296191, 6386.425221730066, 6263.874722505616, 6312.084747711464, 6327.11420401135, 6338.207724034496, 6339.080833279241, 6332.651704156131, 6391.488680905423, 6393.360663933569, 6403.199600049994, 6407.0709747085475, 6029.547783916311, 6107.037103281215, 6277.71750271248, 6300.684965751786, 6304.905426418699, 6231.875362492634, 6243.875122497434, 6284.780032698834, 6324.936750632435, 6326.082718005955, 6167.876642467215, 6191.349908259568, 6197.977333739883, 6204.286507051566, 6213.596116252429, 5924.555658325729, 5946.940530594812, 6003.249593800775, 6181.629102253879, 6201.906971395342, 5840.795572154954, 5958.076498142795, 6054.576179667381, 6066.7269972850445, 6079.696015199311, 6188.0, 6189.783357582463, 6211.192544969125, 6216.191895053795, 6224.657643829632, 5776.682282474504, 6017.578769486094, 6028.186194863637, 6036.8188954331445, 6088.634681919099], "value": 5711.430367053576, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [674.905513228148, 724.5471580262337, 785.9410544209184, 846.1158089796158, 859.4628357276702, 22121.889390553046, 28911.421771564557, 28987.85506072472, 29029.41941161181, 29067.563986540194, 28061.438771224563, 40723.18553628925, 41330.58669413305, 41365.75902722923, 43107.49123780661, 8885.0, 9031.322650801183, 9044.145950080218, 9053.0, 9059.909400906006, 8935.910640893606, 9046.86429703555, 9073.183413492785, 9078.092190780935, 9083.909160908372, 7257.673404696801, 7420.33217010469, 10921.617743378984, 11138.053265472405, 11165.995060444558, 10975.725606859813, 11011.0, 11026.834597481044, 11039.227254092217, 11039.448027598628, 10729.570817167303, 10804.5678172873, 10814.891851081467, 10820.404877731722, 10827.729306767395, 27131.91472341104, 27552.173434796987, 27667.861660691568, 28418.72115754796, 28495.0, 2771.0, 3749.6812770914503, 3772.1324095457926, 3851.4607954886337, 3964.623360780721, 23133.0, 23206.65190022151, 27703.722962770316, 27904.0, 28528.286792830346, 2606.4396154826804, 2830.8584570771377, 2954.9261268468244, 3153.7477001839798, 3163.7469002479747, 354057.0, 354717.0, 354943.0, 356288.0, 356713.9999999974, 49834.0, 49880.750596246784, 49924.0, 49994.250086248736, 50057.49827505181, 55015.724921375135, 55245.723771380886, 55270.44729552734, 55304.0, 55366.44633553613, 13727.382267797973, 13811.171329720048, 13820.032597718064, 13820.930895345458, 13823.861761382257, 11821.527138914518, 11827.586034488751, 11836.993855522376, 11840.993515551274, 11843.407829608484, 10670.30643008202, 11906.583269585522, 12515.937420312841, 12583.93708031454, 12797.232166070065, 4852.126617208865, 5663.122216056518, 5726.885462290731, 5756.683382414008, 5789.0, 897.4525539420948, 990.3612170150212, 1047.2864184686937, 1100.7743412600398, 1111.366291551418, 26017.869910650705, 26441.0, 26562.734372656414, 26585.73414265871, 26737.866310668713, 1184.5025089462447, 1192.1357016163386, 1197.6706405738491, 1246.6571692784557, 1249.7812882745484, 12192.268463892195, 13165.712918469513, 13209.933950330187, 13261.801072983913, 13380.6654833628, 465097.0, 465785.0, 465923.0, 466168.0, 467204.0, 55541.722291389095, 55570.72214638982, 55605.165922511194, 55612.72193639006, 55655.0, 1348.7235116801032, 1391.9930400348137, 1398.4336343780785, 1399.3632897031825, 1409.8519655436032, 23950.8973908046, 24626.384340391633, 24631.0, 24973.87513062423, 25089.87455062713, 46480.7675961618, 46682.83292917704, 46721.0, 46728.0, 46805.29792053054, 354976.0, 355720.0, 356802.0, 356939.0, 358006.0, 23863.880680596485, 23927.880360598087, 23978.0, 23985.76014239905, 24061.51876962416, 39015.414768777926, 39989.2002159961, 40085.0, 41544.792276038424, 42101.36847947344, 31170.532442012933, 31445.213869653442, 32889.17777055593, 33537.832310839265, 33848.3230335387, 32276.83861580677, 32468.75312468734, 32965.84619538401, 33422.665773341956, 34120.14699632529, 32662.51006234956, 32881.50677739788, 32974.0, 33567.160820978694, 33934.151646208054, 27934.30164245829, 29028.0, 29220.0, 29338.706612933598, 29830.0, 20925.056390696678, 22483.10067597278, 22502.66246006344, 22599.435014124778, 22834.429139270986], "value": 17748.34612957272, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [332.8618623271343, 369.4255432801993, 371.2222893039082, 389.38671592242207, 432.16591977483444, 13367.665808354795, 13631.522896698618, 20492.89753551234, 21060.0, 21867.12531498738, 21620.459488512795, 21663.025163867624, 22764.88617556914, 22846.657300140512, 23062.423439414022, 6239.875202495959, 6487.967560162193, 6520.347965203466, 6534.281229064799, 6536.444402225793, 6093.299270583873, 6439.227292724856, 6489.383508566679, 6494.512911531654, 6497.22033355998, 6400.51996100292, 6428.164338635971, 6498.0, 6498.317676643956, 6505.316941721122, 6319.368063193667, 6494.837629059264, 6502.089707440962, 6504.544681872271, 6509.381608747209, 6210.875782484371, 6233.781817636406, 6291.961826298655, 6320.336364681688, 6328.1773369462135, 26441.074562390415, 26800.525971071584, 26852.925882964657, 27024.919003239847, 27145.45709085827, 2842.8152170109083, 2897.3774686175807, 2901.7968742188054, 2919.168037109435, 2933.809302395359, 14222.786658200135, 15634.921825390915, 15883.0, 16416.671666566723, 16968.15159242033, 1662.9750553741703, 1963.391348681899, 1984.4145976936838, 2002.5994801039851, 2082.250389859649, 127122.36438817746, 131295.0, 133636.0, 136349.0, 136535.0, 15599.376024958874, 15760.68478630421, 19311.903440482707, 19502.8049719501, 19566.315178968667, 24950.625740613905, 25755.356116097246, 25760.613590796154, 28132.0, 29218.707812922024, 9588.232941364675, 9927.950360248153, 9967.903530611628, 10025.899741002642, 10154.898451015542, 5372.3184123653855, 7046.260142684944, 7380.188179300273, 7405.259474052552, 7477.327040566266, 8174.264316211569, 9102.362834601514, 9202.953985230031, 9210.95394523023, 9211.355205135576, 3171.9073902944447, 3702.33357995558, 3762.155268611536, 3785.883164466489, 3804.8668296609485, 739.4638886807129, 775.8681024225782, 784.9254320839511, 784.9529028258208, 799.7520768561765, 20797.89601051985, 21294.935253237276, 21807.563848722937, 21871.343859684235, 21877.890610546845, 970.6699722094522, 1008.68226508651, 1046.7226185060965, 1058.1059005140644, 1069.844872493484, 10536.209784266211, 10651.429026113867, 11092.722681932855, 11107.0, 11126.443677816076, 553973.0, 689601.0, 696103.0, 705942.0, 716170.0, 130963.0, 161051.0, 162596.0, 167867.1606641959, 170487.14756426387, 986.506746626701, 1022.9488525573692, 1042.0, 1048.051513380392, 1051.5951358726945, 17992.550186245448, 18539.073046347898, 18596.628067438305, 18612.627747445247, 18686.34597789071, 56891.43108569027, 57023.71488142533, 61615.0, 62953.37046629658, 63647.363526365996, 89184.87160030374, 89672.0, 91285.0, 91870.54064729634, 93229.0, 10880.510377032893, 11258.0, 11493.195476316578, 11629.360385178557, 11704.239224450725, 12388.938055309665, 12560.550692614852, 12588.370581471074, 12646.0, 12750.362481876055, 9556.856647150438, 10664.733381665521, 11157.776844462904, 11275.718107047389, 11320.37737924422, 9937.304388693012, 9998.500074996367, 10544.578216871547, 10680.786384272116, 10887.673369798918, 5812.680302583399, 8099.271065604124, 8507.744767656981, 11334.716632084264, 11613.0, 9348.813023739624, 11031.558737650725, 11079.944600276947, 11365.886341136484, 11421.714457138305, 10805.729856753644, 10972.286801357886, 11009.504572294427, 11085.113190944867, 11144.108471322437], "value": 10884.833117423746, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1415.1721243072802, 1451.0, 1498.4830233569428, 1556.2374436526102, 1561.2427972433372, 10401.0, 10995.34027958323, 11008.174386920973, 11013.339199648006, 11020.559177632895, 10262.74343141422, 10692.305000174983, 10714.982076702701, 10822.891771082286, 10837.512311945962, 2296.7358753743283, 2335.9532809343805, 2337.9883100584475, 2338.754430784769, 2339.438534751656, 2252.0991603358625, 2318.1770471482632, 2353.8352315337847, 2354.9411264718347, 2357.5167090746354, 1909.93043895419, 2046.4270004398793, 2296.8277379196543, 2321.1179751694417, 2325.476767727265, 2288.7711228877147, 2296.7818057284617, 2315.3517015235593, 2321.6749655048307, 2328.9650655240102, 2265.626171681687, 2341.356127065054, 2346.120204923154, 2349.3304408243566, 2349.4713689419746, 10725.78548429027, 10803.513841877057, 10815.83776243357, 10823.13414926804, 10824.350538967687, 5667.886642267132, 5850.122481627747, 5859.589828711949, 5863.58954873159, 5870.09013602888, 3320.9169770755684, 3461.197792464402, 3574.4995700601935, 3615.5299811024397, 3620.8732694355836, 1147.7073346296725, 1161.9883801161964, 1173.718307606177, 1184.3190165654783, 1213.071999920062, 13644.93177534106, 13972.72054558903, 14012.859871401359, 15139.394424223017, 15140.470083547023, 3221.7261532769508, 4330.133973205371, 4338.891527711769, 4341.34879768031, 4341.522432532419, 11222.270552414067, 11534.538618455335, 11560.537578496935, 11703.941480292715, 11742.354170520532, 5440.401555828856, 5536.474034966672, 5536.640118392372, 5543.417941116206, 5545.9722701387045, 4823.1800593899125, 4880.170371036861, 4928.186849169847, 5207.29701490294, 5284.471552844761, 3364.5457863188158, 3681.171736359298, 3748.662620364126, 3820.4269359596283, 3887.436321733333, 1019.4851599942131, 1026.0919086608405, 1028.3983869436313, 1039.0648416425279, 1039.7608550033535, 834.7036801935348, 869.4609342207872, 875.2691502595277, 911.9270458363447, 925.0518218825757, 6364.299927008025, 6417.197850268716, 6641.501887358468, 6697.296783837627, 6746.494012949049, 861.8793368928355, 973.9805203896024, 978.295627148452, 981.215027977615, 1035.7048241251207, 3951.9604803951593, 4006.419069234945, 4092.9795351023054, 4129.525104613008, 4153.875383738493, 12977.41601627929, 13307.933460332637, 13397.330133493286, 13414.329283535784, 13436.320459942508, 13206.386377844097, 13320.467181312833, 13322.600321990356, 13342.0, 13363.331833408485, 9627.470489123025, 10088.192944564416, 10090.747731306776, 10111.443870587189, 10114.494275286206, 5439.9456005441025, 6218.160548325918, 6355.0, 6407.487401008001, 6428.710708018057, 11934.761304774029, 12102.36618056551, 12109.939450302692, 12116.27302361861, 12122.454489547816, 8321.459105158388, 9187.908120918706, 9290.210332121846, 11678.70803229892, 11695.76608467809, 7455.552666840007, 7623.847523049619, 7625.123110842324, 7636.618169091635, 7650.808729781577, 8981.461112333282, 9124.27005839518, 9402.482863442576, 9989.400635961865, 10026.047525485068, 8734.126587341216, 8888.555572221492, 8913.465192088495, 9071.501067441353, 9115.453072815651, 8711.041785403473, 8720.040795512616, 8726.91273087261, 8783.429077109968, 8851.424657397507, 7481.251874812475, 7657.157712651492, 7658.349040331412, 7660.770176894702, 7663.195364486649, 5593.356763972032, 5727.570432217683, 5814.592978491465, 5836.124581312837, 5863.560232982458, 4576.222042252892, 4902.950970490249, 5092.821751238837, 5651.15232715096, 5813.738381772915], "value": 4920.596663780711, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [370.5849448617547, 371.7063519819343, 376.69111328710466, 382.3404627018394, 383.5914750790407, 4273.401723758676, 4643.953560464394, 5153.458886816887, 5298.258243845865, 5304.787808487661, 4305.397244385781, 4307.913841723163, 4911.926321105187, 5201.895962080756, 5212.76542555585, 3769.8501956903065, 3884.533855937277, 4327.826886924519, 4397.164538737646, 4404.317330813713, 4376.496702879162, 4404.216292401583, 4420.6242469390145, 4423.623991960687, 4443.422355093833, 4394.582514661102, 4400.911981760363, 4439.4672639283335, 4449.065696203785, 4450.954025803933, 3529.894103176883, 3741.289155060543, 3965.7422267552515, 4362.847300344504, 4392.011797345572, 3372.274960883422, 3719.9628003719886, 3907.902302442462, 4074.5110586729484, 4104.281750693646, 4784.569388755029, 4884.853454396374, 5111.875387414762, 5199.660152931158, 5238.947610523922, 4862.343583616202, 5110.821121260738, 5117.923231151536, 5148.073346797575, 5154.664946778485, 4456.866294011184, 5517.834464966058, 5521.889562208733, 5553.194786755938, 5567.635929197332, 4498.437695288089, 4499.75251361175, 4521.932171017437, 4525.796339164745, 4580.862574122782, 4802.871325238566, 5392.946070539323, 5664.971675141598, 5864.765409383662, 5869.857502011778, 4367.540574282148, 4397.0546332538015, 4595.356650068993, 4610.331501932201, 4701.341812146302, 4039.7576145431367, 4219.641330486882, 4438.844640437569, 4541.6593755468475, 4798.592119669867, 4227.239096962577, 4873.926891096637, 5037.0681423936685, 5099.796008159632, 5133.974330128325, 5174.741262936838, 5235.424103348629, 5595.300587426572, 5601.29983752031, 5607.8598035048635, 1475.4098360655823, 1531.9199964025336, 1533.8696210822204, 1554.2772610736063, 1558.6648870492897, 1027.5684212630713, 1049.5486940615456, 1124.9043831274432, 1146.2721172055637, 1147.0422197465043, 4520.819167233274, 4535.546445355504, 4546.658735672984, 4819.638527110481, 5044.571211446994, 5033.974830125826, 5104.783986088814, 5274.525292723597, 5628.380878103405, 5634.971825140848, 3849.557300910431, 4956.589898102288, 4985.501449855058, 5037.748112594356, 5061.8228362007885, 2586.754258345492, 2587.826225970194, 2906.4858897053896, 2923.298408381973, 2927.5654929084594, 5053.873653158627, 5207.036698210767, 5268.7091662542925, 5443.924182836685, 5504.697241651667, 4802.89352603519, 4974.030064137531, 5044.419891712427, 5203.19350500673, 5690.012743309712, 5057.570106540985, 5778.971105144531, 5779.739911703983, 5790.88418231633, 5806.796762113306, 5019.62352823547, 5206.791728330824, 5305.5248812028185, 5380.865478363072, 5443.891122177455, 4438.467383913951, 4852.514748525119, 4913.9017219656125, 5405.918911216414, 5506.807261745819, 5329.973350133225, 5442.945570544244, 5676.801311954062, 5761.884762304814, 5779.971100144472, 3614.819259036985, 3861.980690096644, 4435.756033418063, 4477.783497168923, 4496.865094047183, 5166.767495462638, 5261.974139956068, 5540.418256083214, 5558.471945165203, 5596.776128954796, 4579.58033009768, 4742.928856067093, 4780.856574302777, 5361.249425080414, 5386.811461598825, 4262.46719160105, 4906.460289368238, 5040.823571174991, 5182.53357197854, 5413.1880217966045, 4418.624416924597, 4577.954220457753, 5294.523492885659, 5296.364436267672, 5311.44229855875, 4976.925346119883, 5023.271625614192, 5379.488948549882, 5424.891502170013, 5430.429804870431, 4641.559051890065, 4748.955229849427, 4823.011282687111, 5187.19598462239, 5532.197831314517], "value": 4155.823951362767, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [714.4570126703703, 723.4284914917216, 727.7271023366237, 757.3184134279148, 868.0581568997637, 14815.407383704653, 15496.922515387407, 15497.53507394777, 15515.612109697264, 15526.844731552681, 13728.382222799974, 14052.0, 14092.57722268331, 14227.0, 14237.71524569508, 750.6246876561719, 942.4627962061628, 944.0936700767254, 961.889382720989, 961.9519024048805, 955.7706150523859, 957.4829592020335, 958.3195930889077, 960.5149399553216, 961.1157734883924, 946.2619157057471, 990.2226751999682, 993.9861341431736, 997.725625452999, 1027.6043723166597, 986.5412583148799, 986.541258314887, 987.5950860147341, 987.7431867714374, 987.8073775613758, 718.7520305494596, 719.8704233238016, 721.7690339091492, 721.8087206890178, 722.7253643615445, 14573.854261457356, 14580.0, 14612.926935365362, 14697.926510367486, 15520.146391948438, 13881.236531990737, 14189.503367382194, 14192.219427931459, 14195.148291102567, 14195.432182712679, 10826.621068262652, 11343.0, 11461.598844040418, 11526.0, 12175.0868684849, 3745.763897913682, 4320.092780516095, 4367.519572846984, 4395.494518130424, 4506.143832671782, 96488.51755741246, 97239.51380243053, 98425.50787246018, 99758.50120749422, 100129.4980575292, 10311.07200351972, 10312.123469505026, 10657.0, 10658.467076646137, 10760.085392741705, 20318.59362812765, 20667.196187450416, 20870.37388878336, 20874.791252087587, 20877.895610522155, 7285.198628150899, 7307.7807665770115, 7313.0, 7350.926490735131, 7372.483926125227, 4083.1017176221185, 4115.164979349611, 4166.0834616384345, 4170.416141740159, 4188.204241194163, 3242.951355729666, 3304.752143589192, 3326.6340702522702, 3334.549835772188, 3340.816255105944, 519.6674128557726, 599.7164976556551, 600.9158717779427, 617.0312609203597, 620.7610070123035, 512.869218349326, 521.2884412776533, 532.6085327284443, 534.5883669574406, 536.7209051293383, 6573.441257493167, 7703.460757746904, 9050.87094220103, 9421.623135074657, 9584.329096963145, 592.280379339105, 620.3362402229571, 650.4958657040831, 651.1892693596408, 659.1134923527848, 4464.352668862996, 4605.562471565196, 4622.2835460503675, 4679.766011699401, 4684.718916864931, 97546.0, 99547.50678739825, 99904.0, 100299.49850250702, 102529.0, 48547.75726121347, 67405.66297168582, 69233.2691682712, 72084.27915720775, 77399.0, 72418.63790681119, 73722.0, 73808.89286660704, 74277.02891884481, 74900.5019899599, 10478.423686697, 10514.684559463229, 10711.517981690999, 10749.62376316825, 10761.838572421264, 46332.7683361581, 46399.76800115978, 47008.05983880372, 47263.52736472729, 47740.7612961933, 57319.99380021679, 58391.95628152994, 60373.0, 60410.69794650999, 61291.0, 12179.75640487203, 12292.139550231397, 12340.444679989243, 12532.185407948455, 12663.873361266638, 13874.236916969663, 13905.652358691113, 13937.30313484342, 13973.231472269123, 14003.439862405798, 13051.474262868565, 13157.737204429583, 13206.0, 13344.933275333562, 13387.866121338662, 10820.56717731282, 13044.02169837247, 13154.21074735519, 13442.327883605585, 13575.796363054365, 12910.160839545399, 13000.0, 13087.934560327138, 13120.803187951997, 13765.449382025008, 10525.315854469434, 10804.783904322027, 10842.945785271024, 10876.456177191267, 11621.6513504595, 8844.46933184011, 9059.788233420864, 10451.16390688728, 10662.786744265226, 10671.786564268827], "value": 7277.723085715495, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1465.1999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 115.0, 117.0, 116.0, 117.0, 117.0, 116.0, 117.0], "value": 116.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [143.0, 135.0, 143.0, 168.0, 107.0, 109.0, 109.0, 98.0, 148.0, 114.0], "value": 127.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [180.0, 181.0, 185.0, 186.0, 192.0, 180.0, 185.0, 184.0, 182.0, 183.0], "value": 183.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 59.0, 61.0, 89.0, 64.0, 60.0, 60.0, 61.0, 76.0, 62.0], "value": 67.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [91.0, 70.0, 86.0, 70.0, 70.0, 68.0, 84.0, 71.0, 68.0, 85.0], "value": 76.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 89.0, 90.0, 89.0, 89.0, 89.0, 89.0, 89.0, 90.0, 89.0], "value": 89.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 97.0, 96.0, 96.0, 97.0, 96.0, 96.0, 96.0, 97.0, 97.0], "value": 96.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 72.0, 123.0, 69.0, 132.0, 129.0, 103.0, 85.0, 86.0, 85.0], "value": 96.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 60.0, 60.0, 61.0, 61.0, 65.0, 64.0, 64.0, 63.0], "value": 62.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 62.0, 65.0, 62.0, 61.0, 57.0, 58.0, 59.0, 58.0, 58.0], "value": 59.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 89.0, 109.0, 107.0, 107.0, 77.0, 96.0, 108.0, 109.0, 100.0], "value": 98.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 157.0, 169.0, 146.0, 153.0, 139.0, 142.0, 142.0, 183.0, 141.0], "value": 151.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [174.0, 172.0, 175.0, 174.0, 171.0, 170.0, 172.0, 170.0, 172.0, 172.0], "value": 172.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 68.0, 68.0, 67.0, 65.0, 69.0, 66.0, 78.0, 59.0, 61.0], "value": 66.8, "unit": "score"}]}]} 10:33:24 INFO - Return code: 0 10:33:24 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 10:33:24 ERROR - # TBPL SUCCESS # 10:33:24 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:33:24 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:33:24 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:33:24 INFO - 2017-03-02 10:33:24.427 screenresolution[1991:280339] starting screenresolution argv=screenresolution get 10:33:24 INFO - 2017-03-02 10:33:24.430 screenresolution[1991:280339] Display 0: 1600x1200x32@60 10:33:24 INFO - 2017-03-02 10:33:24.436 screenresolution[1992:280342] starting screenresolution argv=screenresolution list 10:33:24 INFO - Available Modes on Display 0 10:33:24 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:33:24 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:33:24 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:33:24 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:33:24 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:33:24 INFO - Intel Iris: 10:33:24 INFO - Chipset Model: Intel Iris 10:33:24 INFO - Type: GPU 10:33:24 INFO - Bus: Built-In 10:33:24 INFO - VRAM (Dynamic, Max): 1536 MB 10:33:24 INFO - Vendor: Intel (0x8086) 10:33:24 INFO - Device ID: 0x0a2e 10:33:24 INFO - Revision ID: 0x0009 10:33:24 INFO - Displays: 10:33:24 INFO - Display: 10:33:24 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:33:24 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:33:24 INFO - Display Serial Number: 1600x1200 60 10:33:24 INFO - Main Display: Yes 10:33:24 INFO - Mirror: Off 10:33:24 INFO - Online: Yes 10:33:24 INFO - Rotation: Supported 10:33:24 INFO - Return code: 0 10:33:24 INFO - Running post-action listener: _resource_record_post_action 10:33:24 INFO - [mozharness: 2017-03-02 18:33:24.668791Z] Finished run-tests step (success) 10:33:24 INFO - Running post-run listener: _resource_record_post_run 10:33:24 INFO - Total resource usage - Wall time: 1204s; CPU: 54.0%; Read bytes: 1551360; Write bytes: 512218112; Read time: 22; Write time: 1585 10:33:24 INFO - TinderboxPrint: CPU usage
53.7% 10:33:24 INFO - TinderboxPrint: I/O read bytes / time
1,551,360 / 22 10:33:24 INFO - TinderboxPrint: I/O write bytes / time
512,218,112 / 1,585 10:33:24 INFO - TinderboxPrint: CPU idle
2,229.5 (46.3%) 10:33:24 INFO - TinderboxPrint: CPU system
959.9 (19.9%) 10:33:24 INFO - TinderboxPrint: CPU user
1,628.2 (33.8%) 10:33:24 INFO - TinderboxPrint: Swap in / out
213,487,616 / 0 10:33:24 INFO - install - Wall time: 21s; CPU: 54.0%; Read bytes: 202906112; Write bytes: 201728000; Read time: 15679; Write time: 429 10:33:24 INFO - run-tests - Wall time: 1184s; CPU: 54.0%; Read bytes: 1551360; Write bytes: 300684288; Read time: 22; Write time: 1120 10:33:25 INFO - Running post-run listener: _upload_blobber_files 10:33:25 INFO - Blob upload gear active. 10:33:25 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:33:25 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 10:33:25 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', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:33:25 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 Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:33:25 INFO - (blobuploader) - INFO - Open directory for files ... 10:33:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 10:33:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:33:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:33:26 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 10:33:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:33:26 INFO - (blobuploader) - INFO - Done attempting. 10:33:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 10:33:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:33:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:33:27 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 10:33:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:33:27 INFO - (blobuploader) - INFO - Done attempting. 10:33:27 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 10:33:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:33:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:33:28 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 10:33:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:33:28 INFO - (blobuploader) - INFO - Done attempting. 10:33:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 10:33:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:33:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:33:31 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 10:33:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:33:31 INFO - (blobuploader) - INFO - Done attempting. 10:33:31 INFO - (blobuploader) - INFO - Iteration through files over. 10:33:31 INFO - Return code: 0 10:33:31 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:33:31 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:33:31 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c2405e5d4980e55ebaeb4f8c22945872ba15ea234aca561ea3d80c963cbfd18dbc9f54030dea6f448f434021e076ba531c976e571a7f156264e04bf4a819da1a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7eacb3b242484c71d4130db00d600b6489a8de6d8cdb3b62e3ec2308f23882909c0ee3e8a208521dd5ad42a415e39bc8fbdf31a4e03707512623f8b6ce48178f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/79301ba2658f2d811f56ca6ab5df0972af97a351da6b6a4c35f8d2ed574056d3341663f0d87ff6e17e25864cfe0f99836010e33421b40a2835f410a68366e1cd", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/099d9a3e9c3921a6c3178783860e5027437c903f74cf2baeee74af98a6fcdb2eab47df327315c0f21c9715f687fb3faa0b21ea4bf734fa18daff9d10f4a77688"} 10:33:31 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:33:31 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:33:31 INFO - Contents: 10:33:31 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c2405e5d4980e55ebaeb4f8c22945872ba15ea234aca561ea3d80c963cbfd18dbc9f54030dea6f448f434021e076ba531c976e571a7f156264e04bf4a819da1a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7eacb3b242484c71d4130db00d600b6489a8de6d8cdb3b62e3ec2308f23882909c0ee3e8a208521dd5ad42a415e39bc8fbdf31a4e03707512623f8b6ce48178f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/79301ba2658f2d811f56ca6ab5df0972af97a351da6b6a4c35f8d2ed574056d3341663f0d87ff6e17e25864cfe0f99836010e33421b40a2835f410a68366e1cd", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/099d9a3e9c3921a6c3178783860e5027437c903f74cf2baeee74af98a6fcdb2eab47df327315c0f21c9715f687fb3faa0b21ea4bf734fa18daff9d10f4a77688"} 10:33:31 INFO - Running post-run listener: copy_logs_to_upload_dir 10:33:31 INFO - Copying logs to upload dir... 10:33:31 INFO - mkdir: /builds/slave/test/build/upload/logs 10:33:31 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1285.591272 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 25 secs) (at 2017-03-02 10:33:31.402060) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-02 10:33:31.409599) ========= 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.QcXlEKos6J/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.XXpfBEumK3/Listeners TMPDIR=/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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/Firefox/sha512/c2405e5d4980e55ebaeb4f8c22945872ba15ea234aca561ea3d80c963cbfd18dbc9f54030dea6f448f434021e076ba531c976e571a7f156264e04bf4a819da1a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7eacb3b242484c71d4130db00d600b6489a8de6d8cdb3b62e3ec2308f23882909c0ee3e8a208521dd5ad42a415e39bc8fbdf31a4e03707512623f8b6ce48178f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/79301ba2658f2d811f56ca6ab5df0972af97a351da6b6a4c35f8d2ed574056d3341663f0d87ff6e17e25864cfe0f99836010e33421b40a2835f410a68366e1cd", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/099d9a3e9c3921a6c3178783860e5027437c903f74cf2baeee74af98a6fcdb2eab47df327315c0f21c9715f687fb3faa0b21ea4bf734fa18daff9d10f4a77688"} build_url:https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011113 build_url: 'https://queue.taskcluster.net/v1/task/K8MjZRWFQYe06Zf0OmnDYw/artifacts/public/build/firefox-54.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c2405e5d4980e55ebaeb4f8c22945872ba15ea234aca561ea3d80c963cbfd18dbc9f54030dea6f448f434021e076ba531c976e571a7f156264e04bf4a819da1a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7eacb3b242484c71d4130db00d600b6489a8de6d8cdb3b62e3ec2308f23882909c0ee3e8a208521dd5ad42a415e39bc8fbdf31a4e03707512623f8b6ce48178f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/79301ba2658f2d811f56ca6ab5df0972af97a351da6b6a4c35f8d2ed574056d3341663f0d87ff6e17e25864cfe0f99836010e33421b40a2835f410a68366e1cd", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/099d9a3e9c3921a6c3178783860e5027437c903f74cf2baeee74af98a6fcdb2eab47df327315c0f21c9715f687fb3faa0b21ea4bf734fa18daff9d10f4a77688"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-02 10:33:31.443478) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 10:33:31.443797) ========= 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.QcXlEKos6J/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.XXpfBEumK3/Listeners TMPDIR=/var/folders/kh/k_6wkq590f76m8yt0lypmfdm00000w/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.005319 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-02 10:33:31.492913) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-02 10:33:31.493515) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-02 10:33:31.493836) ========= ========= Total master_lag: 0.19 =========