builder: mozilla-beta_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0348 starttime: 1482254145.93 results: success (0) buildid: 20161220080652 builduid: 95bf9582e6aa445ab5d66e1e8e71daba revision: 40f05c0d1f30179d1fffe01cba2e71e5bbabb155 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:45.932577) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:45.933309) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:45.933820) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:45.959000) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:45.959315) ========= 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.HTVKprZwJW/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.mVhh5NATt7/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-12-20 09:15:45-- 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% 64.9M=0s 2016-12-20 09:15:46 (64.9 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.166151 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:46.148634) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:46.148957) ========= 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.HTVKprZwJW/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.mVhh5NATt7/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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.020259 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:46.197729) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-12-20 09:15:46.198155) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 40f05c0d1f30179d1fffe01cba2e71e5bbabb155 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 40f05c0d1f30179d1fffe01cba2e71e5bbabb155 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.HTVKprZwJW/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.mVhh5NATt7/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-12-20 09:15:46,279 truncating revision to first 12 chars 2016-12-20 09:15:46,279 Setting DEBUG logging. 2016-12-20 09:15:46,279 attempt 1/10 2016-12-20 09:15:46,279 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/40f05c0d1f30?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-12-20 09:15:47,041 unpacking tar archive at: mozilla-beta-40f05c0d1f30/testing/mozharness/ program finished with exit code 0 elapsedTime=1.040384 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-12-20 09:15:47.262111) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:47.262438) ========= script_repo_revision: 40f05c0d1f30179d1fffe01cba2e71e5bbabb155 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:47.262876) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:47.263176) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-20 09:15:47.283173) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 20 mins, 59 secs) (at 2016-12-20 09:15:47.283536) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 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-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.HTVKprZwJW/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.mVhh5NATt7/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:15:47 INFO - MultiFileLogger online at 20161220 09:15:47 in /builds/slave/test 09:15:47 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 09:15:47 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:15:47 INFO - {'append_to_log': False, 09:15:47 INFO - 'base_work_dir': '/builds/slave/test', 09:15:47 INFO - 'blob_upload_branch': 'Mozilla-Beta', 09:15:47 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:15:47 INFO - 'branch': 'Mozilla-Beta', 09:15:47 INFO - 'buildbot_json_path': 'buildprops.json', 09:15:47 INFO - 'config_files': ('talos/mac_config.py',), 09:15:47 INFO - 'default_actions': ('clobber', 09:15:47 INFO - 'read-buildbot-config', 09:15:47 INFO - 'download-and-extract', 09:15:47 INFO - 'populate-webroot', 09:15:47 INFO - 'create-virtualenv', 09:15:47 INFO - 'install', 09:15:47 INFO - 'run-tests'), 09:15:47 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:15:47 INFO - 'download_minidump_stackwalk': True, 09:15:47 INFO - 'download_symbols': 'ondemand', 09:15:47 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:15:47 INFO - 'tooltool.py': '/tools/tooltool.py', 09:15:47 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:15:47 INFO - '/tools/misc-python/virtualenv.py')}, 09:15:47 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:15:47 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:15:47 INFO - 'installer_path': 'installer.exe', 09:15:47 INFO - 'log_level': 'info', 09:15:47 INFO - 'log_name': 'talos', 09:15:47 INFO - 'log_to_console': True, 09:15:47 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 09:15:47 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 09:15:47 INFO - 'opt_config_files': (), 09:15:47 INFO - 'pip_index': False, 09:15:47 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 09:15:47 INFO - 'cmd': ('bash', 09:15:47 INFO - '-c', 09:15:47 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 09:15:47 INFO - 'enabled': True, 09:15:47 INFO - 'halt_on_failure': False, 09:15:47 INFO - 'name': 'check_screen_resolution'},), 09:15:47 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 09:15:47 INFO - 'cmd': ('bash', 09:15:47 INFO - '-c', 09:15:47 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 09:15:47 INFO - 'enabled': True, 09:15:47 INFO - 'halt_on_failure': False, 09:15:47 INFO - 'name': 'check_screen_resolution'},), 09:15:47 INFO - 'run_cmd_checks_enabled': True, 09:15:47 INFO - 'sps_profile': False, 09:15:47 INFO - 'sps_profile_interval': 0, 09:15:47 INFO - 'suite': 'dromaeojs-e10s', 09:15:47 INFO - 'system_bits': '32', 09:15:47 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:15:47 INFO - 'title': 't-yosemite-r7-0348', 09:15:47 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:15:47 INFO - 'use_talos_json': True, 09:15:47 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:15:47 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:15:47 INFO - 'work_dir': 'build'} 09:15:47 INFO - [mozharness: 2016-12-20 17:15:47.488071Z] Running clobber step. 09:15:47 INFO - Running pre-action listener: _resource_record_pre_action 09:15:47 INFO - Running main action method: clobber 09:15:47 INFO - rmtree: /builds/slave/test/build 09:15:47 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:15:49 INFO - Running post-action listener: _resource_record_post_action 09:15:49 INFO - [mozharness: 2016-12-20 17:15:49.680435Z] Finished clobber step (success) 09:15:49 INFO - [mozharness: 2016-12-20 17:15:49.680692Z] Running read-buildbot-config step. 09:15:49 INFO - Running pre-action listener: _resource_record_pre_action 09:15:49 INFO - Running main action method: read_buildbot_config 09:15:49 INFO - Using buildbot properties: 09:15:49 INFO - { 09:15:49 INFO - "project": "", 09:15:49 INFO - "product": "firefox", 09:15:49 INFO - "script_repo_revision": "production", 09:15:49 INFO - "builddir": "mozilla-beta_yosemite_r7_test-dromaeojs-e10s", 09:15:49 INFO - "repository": "", 09:15:49 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-beta talos dromaeojs-e10s", 09:15:49 INFO - "buildid": "20161220080652", 09:15:49 INFO - "pgo_build": "False", 09:15:49 INFO - "basedir": "/builds/slave/test", 09:15:49 INFO - "buildnumber": 0, 09:15:49 INFO - "slavename": "t-yosemite-r7-0348", 09:15:49 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 09:15:49 INFO - "platform": "yosemite_r7", 09:15:49 INFO - "scheduler": "tests-mozilla-beta-macosx64-talos", 09:15:49 INFO - "branch": "mozilla-beta", 09:15:49 INFO - "repo_path": "releases/mozilla-beta", 09:15:49 INFO - "revision": "40f05c0d1f30179d1fffe01cba2e71e5bbabb155", 09:15:49 INFO - "stage_platform": "macosx64", 09:15:49 INFO - "builduid": "95bf9582e6aa445ab5d66e1e8e71daba", 09:15:49 INFO - "slavebuilddir": "test" 09:15:49 INFO - } 09:15:49 INFO - Found installer url https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.dmg. 09:15:49 INFO - Running post-action listener: _resource_record_post_action 09:15:49 INFO - [mozharness: 2016-12-20 17:15:49.686472Z] Finished read-buildbot-config step (success) 09:15:49 INFO - [mozharness: 2016-12-20 17:15:49.686629Z] Running download-and-extract step. 09:15:49 INFO - Running pre-action listener: _resource_record_pre_action 09:15:49 INFO - Running main action method: download_and_extract 09:15:49 INFO - mkdir: /builds/slave/test/build/tests 09:15:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:15:49 INFO - trying https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.test_packages.json 09:15:49 INFO - Downloading https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0.en-US.mac.test_packages.json 09:15:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0.en-US.mac.test_packages.json'}, attempt #1 09:15:50 INFO - Downloaded 1165 bytes. 09:15:50 INFO - Reading from file /builds/slave/test/build/firefox-51.0.en-US.mac.test_packages.json 09:15:50 INFO - Using the following test package requirements: 09:15:50 INFO - {u'common': [u'firefox-51.0.en-US.mac.common.tests.zip'], 09:15:50 INFO - u'cppunittest': [u'firefox-51.0.en-US.mac.common.tests.zip', 09:15:50 INFO - u'firefox-51.0.en-US.mac.cppunittest.tests.zip'], 09:15:50 INFO - u'gtest': [u'firefox-51.0.en-US.mac.common.tests.zip', 09:15:50 INFO - u'firefox-51.0.en-US.mac.gtest.tests.zip'], 09:15:50 INFO - u'jittest': [u'firefox-51.0.en-US.mac.common.tests.zip', u'jsshell-mac.zip'], 09:15:50 INFO - u'mochitest': [u'firefox-51.0.en-US.mac.common.tests.zip', 09:15:50 INFO - u'firefox-51.0.en-US.mac.mochitest.tests.zip'], 09:15:50 INFO - u'mozbase': [u'firefox-51.0.en-US.mac.common.tests.zip'], 09:15:50 INFO - u'reftest': [u'firefox-51.0.en-US.mac.common.tests.zip', 09:15:50 INFO - u'firefox-51.0.en-US.mac.reftest.tests.zip'], 09:15:50 INFO - u'talos': [u'firefox-51.0.en-US.mac.common.tests.zip', 09:15:50 INFO - u'firefox-51.0.en-US.mac.talos.tests.zip'], 09:15:50 INFO - u'web-platform': [u'firefox-51.0.en-US.mac.common.tests.zip', 09:15:50 INFO - u'firefox-51.0.en-US.mac.web-platform.tests.zip'], 09:15:50 INFO - u'xpcshell': [u'firefox-51.0.en-US.mac.common.tests.zip', 09:15:50 INFO - u'firefox-51.0.en-US.mac.xpcshell.tests.zip']} 09:15:50 INFO - Downloading packages: [u'firefox-51.0.en-US.mac.common.tests.zip'] for test suite category: common 09:15:50 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.common.tests.zip 09:15:50 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.common.tests.zip'}, attempt #1 09:15:50 INFO - Fetch https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.common.tests.zip into memory 09:15:51 INFO - Expected file size: 16232538 09:15:58 INFO - Downloading packages: [u'firefox-51.0.en-US.mac.common.tests.zip', u'firefox-51.0.en-US.mac.talos.tests.zip'] for test suite category: talos 09:15:58 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.common.tests.zip 09:15:58 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.common.tests.zip'}, attempt #1 09:15:58 INFO - Fetch https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.common.tests.zip into memory 09:15:58 INFO - Expected file size: 16232538 09:16:05 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.talos.tests.zip 09:16:05 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.talos.tests.zip'}, attempt #1 09:16:05 INFO - Fetch https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.talos.tests.zip into memory 09:16:06 INFO - Expected file size: 14414089 09:16:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:07 INFO - trying https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.dmg 09:16:07 INFO - Downloading https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0.en-US.mac.dmg 09:16:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0.en-US.mac.dmg'}, attempt #1 09:16:09 INFO - Downloaded 86057353 bytes. 09:16:09 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.dmg 09:16:09 INFO - mkdir: /builds/slave/test/properties 09:16:09 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:16:09 INFO - Writing to file /builds/slave/test/properties/build_url 09:16:09 INFO - Contents: 09:16:09 INFO - build_url:https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.dmg 09:16:10 INFO - Running post-action listener: _resource_record_post_action 09:16:10 INFO - Running post-action listener: set_extra_try_arguments 09:16:10 INFO - [mozharness: 2016-12-20 17:16:10.099545Z] Finished download-and-extract step (success) 09:16:10 INFO - [mozharness: 2016-12-20 17:16:10.099684Z] Running populate-webroot step. 09:16:10 INFO - Running pre-action listener: _resource_record_pre_action 09:16:10 INFO - Running main action method: populate_webroot 09:16:10 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:16:10 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:16:10 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:16:10 INFO - '--tppagecycles', 09:16:10 INFO - '7'], 09:16:10 INFO - 'tests': ['tsvgm']}}, 09:16:10 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:16:10 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:16:10 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:16:10 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:16:10 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:16:10 INFO - 'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:16:10 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:16:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:16:10 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:16:10 INFO - 'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['damp', 'tps']}, 09:16:10 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:16:10 INFO - 'tests': ['damp', 'tps']}, 09:16:10 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['dromaeo_dom']}, 09:16:10 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:16:10 INFO - 'g4': {'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['basic_compositor_video']}, 09:16:10 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 09:16:10 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['a11yr', 09:16:10 INFO - 'ts_paint', 09:16:10 INFO - 'tpaint', 09:16:10 INFO - 'sessionrestore', 09:16:10 INFO - 'sessionrestore_no_auto_restore', 09:16:10 INFO - 'tabpaint']}, 09:16:10 INFO - 'other-e10s': {'tests': ['a11yr', 09:16:10 INFO - 'ts_paint', 09:16:10 INFO - 'tpaint', 09:16:10 INFO - 'sessionrestore', 09:16:10 INFO - 'sessionrestore_no_auto_restore', 09:16:10 INFO - 'tabpaint']}, 09:16:10 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:16:10 INFO - 'ts_paint', 09:16:10 INFO - 'tpaint', 09:16:10 INFO - 'sessionrestore', 09:16:10 INFO - 'sessionrestore_no_auto_restore', 09:16:10 INFO - 'tabpaint']}, 09:16:10 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:16:10 INFO - 'ts_paint', 09:16:10 INFO - 'tpaint', 09:16:10 INFO - 'sessionrestore', 09:16:10 INFO - 'sessionrestore_no_auto_restore', 09:16:10 INFO - 'tabpaint']}, 09:16:10 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['a11yr', 09:16:10 INFO - 'ts_paint', 09:16:10 INFO - 'tpaint', 09:16:10 INFO - 'sessionrestore', 09:16:10 INFO - 'sessionrestore_no_auto_restore', 09:16:10 INFO - 'tabpaint']}, 09:16:10 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['a11yr', 09:16:10 INFO - 'ts_paint', 09:16:10 INFO - 'tpaint', 09:16:10 INFO - 'sessionrestore', 09:16:10 INFO - 'sessionrestore_no_auto_restore', 09:16:10 INFO - 'tabpaint']}, 09:16:10 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['tsvgx', 09:16:10 INFO - 'tsvgr_opacity', 09:16:10 INFO - 'tart', 09:16:10 INFO - 'tscrollx', 09:16:10 INFO - 'cart']}, 09:16:10 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:16:10 INFO - 'tsvgr_opacity', 09:16:10 INFO - 'tart', 09:16:10 INFO - 'tscrollx', 09:16:10 INFO - 'cart']}, 09:16:10 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:16:10 INFO - 'talos_options': ['--disable-e10s'], 09:16:10 INFO - 'tests': ['tp5o']}, 09:16:10 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:16:10 INFO - 'tests': ['tp5o']}, 09:16:10 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:16:10 INFO - 'talos_options': ['--disable-e10s', 09:16:10 INFO - '--xperf_path', 09:16:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:16:10 INFO - 'tests': ['tp5n']}, 09:16:10 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:16:10 INFO - 'talos_options': ['--xperf_path', 09:16:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:16:10 INFO - 'tests': ['tp5n']}}, 09:16:10 INFO - 'talos.zip': {'path': '', 09:16:10 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:16:10 INFO - Running post-action listener: _resource_record_post_action 09:16:10 INFO - [mozharness: 2016-12-20 17:16:10.118707Z] Finished populate-webroot step (success) 09:16:10 INFO - [mozharness: 2016-12-20 17:16:10.118837Z] Running create-virtualenv step. 09:16:10 INFO - Running pre-action listener: _resource_record_pre_action 09:16:10 INFO - Running main action method: create_virtualenv 09:16:10 INFO - Creating virtualenv /builds/slave/test/build/venv 09:16:10 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 09:16:10 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:16:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:16:10 INFO - Using real prefix '/tools/python27' 09:16:10 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:16:10 INFO - Installing distribute.............................................................................................................................................................................................done. 09:16:13 INFO - Installing pip.................done. 09:16:13 INFO - Return code: 0 09:16:13 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:16:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:13 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:13 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 09:16:13 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 09:16:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:13 INFO - 'HOME': '/Users/cltbld', 09:16:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:13 INFO - 'LOGNAME': 'cltbld', 09:16:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:13 INFO - 'MOZ_NO_REMOTE': '1', 09:16:13 INFO - 'NO_EM_RESTART': '1', 09:16:13 INFO - 'PAGER': '/bin/cat', 09:16:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:13 INFO - 'PWD': '/builds/slave/test', 09:16:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:13 INFO - 'SHELL': '/bin/bash', 09:16:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:13 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:13 INFO - 'USER': 'cltbld', 09:16:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:13 INFO - 'XPC_FLAGS': '0x0', 09:16:13 INFO - 'XPC_SERVICE_NAME': '0', 09:16:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:14 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 09:16:14 INFO - Cleaning up... 09:16:14 INFO - Return code: 0 09:16:14 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 09:16: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')]} 09:16:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16: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')]} 09:16:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:14 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:14 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 09:16:14 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 09:16:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:14 INFO - 'HOME': '/Users/cltbld', 09:16:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:14 INFO - 'LOGNAME': 'cltbld', 09:16:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:14 INFO - 'MOZ_NO_REMOTE': '1', 09:16:14 INFO - 'NO_EM_RESTART': '1', 09:16:14 INFO - 'PAGER': '/bin/cat', 09:16:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:14 INFO - 'PWD': '/builds/slave/test', 09:16:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:14 INFO - 'SHELL': '/bin/bash', 09:16:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:14 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:14 INFO - 'USER': 'cltbld', 09:16:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:14 INFO - 'XPC_FLAGS': '0x0', 09:16:14 INFO - 'XPC_SERVICE_NAME': '0', 09:16:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:14 INFO - Downloading/unpacking psutil>=3.1.1 09:16:14 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 09:16:14 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 09:16:14 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 09:16:14 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 09:16:14 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 09:16:14 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 09:16:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:16:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:16:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:16:17 INFO - Installing collected packages: psutil 09:16:17 INFO - Running setup.py install for psutil 09:16:17 INFO - building 'psutil._psutil_osx' extension 09:16:17 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 09:16:17 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 09:16:18 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 09:16:18 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 09:16:18 INFO - building 'psutil._psutil_posix' extension 09:16:18 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 09:16:18 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 09:16:18 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 09:16:18 INFO - ^ 09:16:18 INFO - 1 warning generated. 09:16:18 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 09:16:18 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:16:18 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:16:18 INFO - Successfully installed psutil 09:16:18 INFO - Cleaning up... 09:16:18 INFO - Return code: 0 09:16:18 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 09:16:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 09:16:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 09:16:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:18 INFO - 'HOME': '/Users/cltbld', 09:16:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:18 INFO - 'LOGNAME': 'cltbld', 09:16:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:18 INFO - 'MOZ_NO_REMOTE': '1', 09:16:18 INFO - 'NO_EM_RESTART': '1', 09:16:18 INFO - 'PAGER': '/bin/cat', 09:16:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:18 INFO - 'PWD': '/builds/slave/test', 09:16:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:18 INFO - 'SHELL': '/bin/bash', 09:16:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:18 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:18 INFO - 'USER': 'cltbld', 09:16:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:18 INFO - 'XPC_FLAGS': '0x0', 09:16:18 INFO - 'XPC_SERVICE_NAME': '0', 09:16:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:18 INFO - Downloading/unpacking mozsystemmonitor==0.3 09:16:18 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 09:16:18 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 09:16:18 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 09:16:18 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 09:16:18 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 09:16:18 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 09:16:21 INFO - Downloading mozsystemmonitor-0.3.tar.gz 09:16:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:16:21 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 09:16:21 INFO - Installing collected packages: mozsystemmonitor 09:16:21 INFO - Running setup.py install for mozsystemmonitor 09:16:21 INFO - Successfully installed mozsystemmonitor 09:16:21 INFO - Cleaning up... 09:16:21 INFO - Return code: 0 09:16:21 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 09:16:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:21 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:21 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 09:16:21 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 09:16:21 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:21 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:21 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:21 INFO - 'HOME': '/Users/cltbld', 09:16:21 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:21 INFO - 'LOGNAME': 'cltbld', 09:16:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:21 INFO - 'MOZ_NO_REMOTE': '1', 09:16:21 INFO - 'NO_EM_RESTART': '1', 09:16:21 INFO - 'PAGER': '/bin/cat', 09:16:21 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:21 INFO - 'PWD': '/builds/slave/test', 09:16:21 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:21 INFO - 'SHELL': '/bin/bash', 09:16:21 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:21 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:21 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:21 INFO - 'USER': 'cltbld', 09:16:21 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:21 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:21 INFO - 'XPC_FLAGS': '0x0', 09:16:21 INFO - 'XPC_SERVICE_NAME': '0', 09:16:21 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:21 INFO - Downloading/unpacking jsonschema==2.5.1 09:16:21 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 09:16:21 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 09:16:21 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 09:16:21 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 09:16:21 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 09:16:21 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 09:16:24 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:16:24 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 09:16:24 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 09:16:24 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 09:16:24 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 09:16:24 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 09:16:24 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 09:16:24 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 09:16:24 INFO - Downloading functools32-3.2.3-2.tar.gz 09:16:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:16:24 INFO - warning: no files found matching '*.txt' 09:16:24 INFO - no previously-included directories found matching 'build' 09:16:24 INFO - no previously-included directories found matching 'dist' 09:16:24 INFO - no previously-included directories found matching '.git*' 09:16:24 INFO - Installing collected packages: jsonschema, functools32 09:16:25 INFO - Running setup.py install for functools32 09:16:25 INFO - warning: no files found matching '*.txt' 09:16:25 INFO - no previously-included directories found matching 'build' 09:16:25 INFO - no previously-included directories found matching 'dist' 09:16:25 INFO - no previously-included directories found matching '.git*' 09:16:25 INFO - Successfully installed jsonschema functools32 09:16:25 INFO - Cleaning up... 09:16:25 INFO - Return code: 0 09:16:25 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 09:16:25 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')]} 09:16:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:25 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')]} 09:16:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:25 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:25 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 09:16:25 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 09:16:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:25 INFO - 'HOME': '/Users/cltbld', 09:16:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:25 INFO - 'LOGNAME': 'cltbld', 09:16:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:25 INFO - 'MOZ_NO_REMOTE': '1', 09:16:25 INFO - 'NO_EM_RESTART': '1', 09:16:25 INFO - 'PAGER': '/bin/cat', 09:16:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:25 INFO - 'PWD': '/builds/slave/test', 09:16:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:25 INFO - 'SHELL': '/bin/bash', 09:16:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:25 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:25 INFO - 'USER': 'cltbld', 09:16:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:25 INFO - 'XPC_FLAGS': '0x0', 09:16:25 INFO - 'XPC_SERVICE_NAME': '0', 09:16:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:25 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 09:16:25 INFO - Cleaning up... 09:16:25 INFO - Return code: 0 09:16:25 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:16:25 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')]} 09:16:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:25 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')]} 09:16:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:25 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:25 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 09:16:25 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 09:16:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:25 INFO - 'HOME': '/Users/cltbld', 09:16:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:25 INFO - 'LOGNAME': 'cltbld', 09:16:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:25 INFO - 'MOZ_NO_REMOTE': '1', 09:16:25 INFO - 'NO_EM_RESTART': '1', 09:16:25 INFO - 'PAGER': '/bin/cat', 09:16:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:25 INFO - 'PWD': '/builds/slave/test', 09:16:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:25 INFO - 'SHELL': '/bin/bash', 09:16:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:25 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:25 INFO - 'USER': 'cltbld', 09:16:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:25 INFO - 'XPC_FLAGS': '0x0', 09:16:25 INFO - 'XPC_SERVICE_NAME': '0', 09:16:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:25 INFO - Downloading/unpacking blobuploader==1.2.4 09:16:25 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 09:16:25 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 09:16:25 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 09:16:25 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 09:16:25 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 09:16:25 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 09:16:29 INFO - Downloading blobuploader-1.2.4.tar.gz 09:16:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:16:29 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:16:29 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 09:16:29 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 09:16:29 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 09:16:29 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 09:16:29 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 09:16:29 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 09:16:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:16:30 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:16:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:16:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:16:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:16:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:16:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:16:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:16:30 INFO - Downloading docopt-0.6.1.tar.gz 09:16:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:16:30 INFO - Installing collected packages: blobuploader, requests, docopt 09:16:30 INFO - Running setup.py install for blobuploader 09:16:30 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:16:30 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:16:30 INFO - Running setup.py install for requests 09:16:31 INFO - Running setup.py install for docopt 09:16:31 INFO - Successfully installed blobuploader requests docopt 09:16:31 INFO - Cleaning up... 09:16:31 INFO - Return code: 0 09:16:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:16:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:31 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:31 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 09:16:31 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 09:16:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:31 INFO - 'HOME': '/Users/cltbld', 09:16:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:31 INFO - 'LOGNAME': 'cltbld', 09:16:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:31 INFO - 'MOZ_NO_REMOTE': '1', 09:16:31 INFO - 'NO_EM_RESTART': '1', 09:16:31 INFO - 'PAGER': '/bin/cat', 09:16:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:31 INFO - 'PWD': '/builds/slave/test', 09:16:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:31 INFO - 'SHELL': '/bin/bash', 09:16:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:31 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:31 INFO - 'USER': 'cltbld', 09:16:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:31 INFO - 'XPC_FLAGS': '0x0', 09:16:31 INFO - 'XPC_SERVICE_NAME': '0', 09:16:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:16:31 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-WQFVp5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:16:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:16:31 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-9VjU6N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-W7hUT1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-U36V6P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-3UZerk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-4Z_COq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-FPqPnn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-JqGTpP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-5N21wU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-m6kyWr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-17CIdH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:16:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-_baWXZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:16:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-z4UyWo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:16:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-FdhJOK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:16:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-bXk1iV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:16:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-rPzZn2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:16:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-bBz8z9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:16:33 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:16:33 INFO - Running setup.py install for manifestparser 09:16:33 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:16:33 INFO - Running setup.py install for mozcrash 09:16:33 INFO - Running setup.py install for mozdebug 09:16:34 INFO - Running setup.py install for mozdevice 09:16:34 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:16:34 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:16:34 INFO - Running setup.py install for mozfile 09:16:34 INFO - Running setup.py install for mozhttpd 09:16:34 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:16:34 INFO - Running setup.py install for mozinfo 09:16:34 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:16:34 INFO - Running setup.py install for mozInstall 09:16:34 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:16:34 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:16:34 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:16:34 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:16:34 INFO - Running setup.py install for mozleak 09:16:34 INFO - Running setup.py install for mozlog 09:16:35 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:16:35 INFO - Running setup.py install for moznetwork 09:16:35 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:16:35 INFO - Running setup.py install for mozprocess 09:16:35 INFO - Running setup.py install for mozprofile 09:16:35 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:16:35 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:16:35 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:16:35 INFO - Running setup.py install for mozrunner 09:16:35 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:16:35 INFO - Running setup.py install for mozscreenshot 09:16:35 INFO - Running setup.py install for moztest 09:16:36 INFO - Running setup.py install for mozversion 09:16:36 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:16:36 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:16:36 INFO - Cleaning up... 09:16:36 INFO - Return code: 0 09:16:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:16:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:16:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:36 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:36 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 09:16:36 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 09:16:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:36 INFO - 'HOME': '/Users/cltbld', 09:16:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:36 INFO - 'LOGNAME': 'cltbld', 09:16:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:36 INFO - 'MOZ_NO_REMOTE': '1', 09:16:36 INFO - 'NO_EM_RESTART': '1', 09:16:36 INFO - 'PAGER': '/bin/cat', 09:16:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:36 INFO - 'PWD': '/builds/slave/test', 09:16:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:36 INFO - 'SHELL': '/bin/bash', 09:16:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:36 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:36 INFO - 'USER': 'cltbld', 09:16:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:36 INFO - 'XPC_FLAGS': '0x0', 09:16:36 INFO - 'XPC_SERVICE_NAME': '0', 09:16:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:16:36 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-dlOV8Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:16:36 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)) 09:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:16:36 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-f5hd6X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:16:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:16:36 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-z31LQI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:16:36 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)) 09:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:16:36 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-lZJT_G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:16:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:16:36 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-i1VnMw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:16:36 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)) 09:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-LsSMiP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:16:37 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)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-ZsnutV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:16:37 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)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-J9NiM_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:16:37 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)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-EWJbEz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:16:37 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)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-6ZLMmf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:16:37 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)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-ZewJUv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:16:37 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)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-2rjS2E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:16:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-q5zuZM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:16:37 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)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-reHOW1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:16:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 09:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:16:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-_eOdyn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:16:38 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)) 09:16:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:16:38 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-B91ZfO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:16:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 09:16:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:16:38 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-lzhsl9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:16:38 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)) 09:16:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:16:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:16:38 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)) 09:16:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:16:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:16:38 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:16:38 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 09:16:38 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 09:16:38 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 09:16:38 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 09:16:38 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 09:16:38 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 09:16:40 INFO - Downloading blessings-1.6.tar.gz 09:16:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:16:41 INFO - Installing collected packages: blessings 09:16:41 INFO - Running setup.py install for blessings 09:16:41 INFO - Successfully installed blessings 09:16:41 INFO - Cleaning up... 09:16:41 INFO - Return code: 0 09:16:41 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:16:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:16:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:16:41 INFO - Reading from file tmpfile_stdout 09:16:41 INFO - Current package versions: 09:16:41 INFO - blessings == 1.6 09:16:41 INFO - blobuploader == 1.2.4 09:16:41 INFO - docopt == 0.6.1 09:16:41 INFO - functools32 == 3.2.3-2 09:16:41 INFO - jsonschema == 2.5.1 09:16:41 INFO - manifestparser == 1.1 09:16:41 INFO - mozInstall == 1.12 09:16:41 INFO - mozcrash == 0.17 09:16:41 INFO - mozdebug == 0.1 09:16:41 INFO - mozdevice == 0.48 09:16:41 INFO - mozfile == 1.2 09:16:41 INFO - mozhttpd == 0.7 09:16:41 INFO - mozinfo == 0.9 09:16:41 INFO - mozleak == 0.1 09:16:41 INFO - mozlog == 3.4 09:16:41 INFO - moznetwork == 0.27 09:16:41 INFO - mozprocess == 0.23 09:16:41 INFO - mozprofile == 0.28 09:16:41 INFO - mozrunner == 6.12 09:16:41 INFO - mozscreenshot == 0.1 09:16:41 INFO - mozsystemmonitor == 0.3 09:16:41 INFO - moztest == 0.7 09:16:41 INFO - mozversion == 1.4 09:16:41 INFO - psutil == 3.1.1 09:16:41 INFO - requests == 1.2.3 09:16:41 INFO - wsgiref == 0.1.2 09:16:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:16: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')]} 09:16:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16: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')]} 09:16:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:41 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:41 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 09:16:41 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 09:16:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:41 INFO - 'HOME': '/Users/cltbld', 09:16:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:41 INFO - 'LOGNAME': 'cltbld', 09:16:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:41 INFO - 'MOZ_NO_REMOTE': '1', 09:16:41 INFO - 'NO_EM_RESTART': '1', 09:16:41 INFO - 'PAGER': '/bin/cat', 09:16:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:41 INFO - 'PWD': '/builds/slave/test', 09:16:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:41 INFO - 'SHELL': '/bin/bash', 09:16:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:41 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:41 INFO - 'USER': 'cltbld', 09:16:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:41 INFO - 'XPC_FLAGS': '0x0', 09:16:41 INFO - 'XPC_SERVICE_NAME': '0', 09:16:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 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)) 09:16:41 INFO - Cleaning up... 09:16:41 INFO - Return code: 0 09:16:41 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:16: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')]} 09:16:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:16:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16: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')]} 09:16:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:16:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:16:41 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 0x10b027490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10af9d570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f97b0d9c4a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, '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.HTVKprZwJW/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.mVhh5NATt7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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 09:16:41 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 09:16:41 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 09:16:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:16:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:16:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:16:41 INFO - 'HOME': '/Users/cltbld', 09:16:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:16:41 INFO - 'LOGNAME': 'cltbld', 09:16:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:16:41 INFO - 'MOZ_NO_REMOTE': '1', 09:16:41 INFO - 'NO_EM_RESTART': '1', 09:16:41 INFO - 'PAGER': '/bin/cat', 09:16:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:16:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:16:41 INFO - 'PWD': '/builds/slave/test', 09:16:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:16:41 INFO - 'SHELL': '/bin/bash', 09:16:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:16:41 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:16:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:16:41 INFO - 'USER': 'cltbld', 09:16:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:16:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:16:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:16:41 INFO - 'XPC_FLAGS': '0x0', 09:16:41 INFO - 'XPC_SERVICE_NAME': '0', 09:16:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:16:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:16:42 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 09:16:42 INFO - Cleaning up... 09:16:42 INFO - Return code: 0 09:16:42 INFO - Running post-action listener: _resource_record_post_action 09:16:42 INFO - Running post-action listener: _start_resource_monitoring 09:16:42 INFO - Starting resource monitoring. 09:16:42 INFO - [mozharness: 2016-12-20 17:16:42.095292Z] Finished create-virtualenv step (success) 09:16:42 INFO - [mozharness: 2016-12-20 17:16:42.096267Z] Running install step. 09:16:42 INFO - Running pre-action listener: _resource_record_pre_action 09:16:42 INFO - Running main action method: install 09:16:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:16:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:16:42 INFO - Reading from file tmpfile_stdout 09:16:42 INFO - Detecting whether we're running mozinstall >=1.0... 09:16:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:16:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:16:42 INFO - Reading from file tmpfile_stdout 09:16:42 INFO - Output received: 09:16:42 INFO - Usage: mozinstall [options] installer 09:16:42 INFO - Options: 09:16:42 INFO - -h, --help show this help message and exit 09:16:42 INFO - -d DEST, --destination=DEST 09:16:42 INFO - Directory to install application into. [default: 09:16:42 INFO - "/builds/slave/test"] 09:16:42 INFO - --app=APP Application being installed. [default: firefox] 09:16:42 INFO - mkdir: /builds/slave/test/build/application 09:16:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 09:16:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0.en-US.mac.dmg --destination /builds/slave/test/build/application 09:17:04 INFO - Reading from file tmpfile_stdout 09:17:04 INFO - Output received: 09:17:04 INFO - /builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox 09:17:04 INFO - Running post-action listener: _resource_record_post_action 09:17:04 INFO - [mozharness: 2016-12-20 17:17:04.716890Z] Finished install step (success) 09:17:04 INFO - [mozharness: 2016-12-20 17:17:04.717035Z] Running run-tests step. 09:17:04 INFO - Running pre-action listener: _resource_record_pre_action 09:17:04 INFO - Running main action method: run_tests 09:17:04 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 09:17:04 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 09:17:04 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 09:17:04 INFO - 2016-12-20 09:17:04.731 screenresolution[1948:10230] starting screenresolution argv=screenresolution get 09:17:04 INFO - 2016-12-20 09:17:04.734 screenresolution[1948:10230] Display 0: 1600x1200x32@60 09:17:04 INFO - 2016-12-20 09:17:04.739 screenresolution[1949:10232] starting screenresolution argv=screenresolution list 09:17:04 INFO - Available Modes on Display 0 09:17:04 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 09:17:04 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 09:17:04 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 09:17:04 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 09:17:04 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 09:17:04 INFO - Intel Iris: 09:17:04 INFO - Chipset Model: Intel Iris 09:17:04 INFO - Type: GPU 09:17:04 INFO - Bus: Built-In 09:17:04 INFO - VRAM (Dynamic, Max): 1536 MB 09:17:04 INFO - Vendor: Intel (0x8086) 09:17:04 INFO - Device ID: 0x0a2e 09:17:04 INFO - Revision ID: 0x0009 09:17:04 INFO - Displays: 09:17:04 INFO - Display: 09:17:04 INFO - Resolution: 1600 x 1200 @ 60 Hz 09:17:04 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 09:17:04 INFO - Display Serial Number: 1600x1200 60 09:17:04 INFO - Main Display: Yes 09:17:04 INFO - Mirror: Off 09:17:04 INFO - Online: Yes 09:17:04 INFO - Rotation: Supported 09:17:04 INFO - Return code: 0 09:17:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:17:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:17:04 INFO - Python 2.7.3 09:17:04 INFO - Return code: 0 09:17:04 INFO - grabbing minidump binary from tooltool 09:17: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')]} 09:17:04 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 0x10ae3bd30>, '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 0x10aca1db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10ae33b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:17:04 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 09:17:04 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 09:17:04 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 09:17:05 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:17:05 INFO - Return code: 0 09:17:05 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 09:17:05 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:17:05 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:17:05 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 09:17:05 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:17:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0348', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 09:17:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0348 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 09:17:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HTVKprZwJW/Render', 09:17:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:17:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:17:05 INFO - 'HOME': '/Users/cltbld', 09:17:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:17:05 INFO - 'LOGNAME': 'cltbld', 09:17:05 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:17:05 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 09:17:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:17:05 INFO - 'MOZ_NO_REMOTE': '1', 09:17:05 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:17:05 INFO - 'NO_EM_RESTART': '1', 09:17:05 INFO - 'PAGER': '/bin/cat', 09:17:05 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:17:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:17:05 INFO - 'PWD': '/builds/slave/test', 09:17:05 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:17:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:17:05 INFO - 'SHELL': '/bin/bash', 09:17:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.mVhh5NATt7/Listeners', 09:17:05 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 09:17:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:17:05 INFO - 'USER': 'cltbld', 09:17:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:17:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:17:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:17:05 INFO - 'XPC_FLAGS': '0x0', 09:17:05 INFO - 'XPC_SERVICE_NAME': '0', 09:17:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 09:17:05 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0348', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 09:17:05 INFO - mozversion application_buildid: 20161220080652 09:17:05 INFO - mozversion application_changeset: 40f05c0d1f30179d1fffe01cba2e71e5bbabb155 09:17:05 INFO - mozversion application_display_name: Firefox 09:17:05 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:17:05 INFO - mozversion application_name: Firefox 09:17:05 INFO - mozversion application_remotingname: firefox 09:17:05 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 09:17:05 INFO - mozversion application_vendor: Mozilla 09:17:05 INFO - mozversion application_version: 51.0 09:17:05 INFO - mozversion platform_buildid: 20161220080652 09:17:05 INFO - mozversion platform_changeset: 40f05c0d1f30179d1fffe01cba2e71e5bbabb155 09:17:05 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 09:17:05 INFO - mozversion platform_version: 51.0 09:17:05 INFO - using testdate: 1482254225 09:17:05 INFO - actual date: 1482254225 09:17:05 INFO - starting webserver on 'localhost:49333' 09:17:05 INFO - SUITE-START | Running 2 tests 09:17:05 INFO - TEST-START | dromaeo_css 09:17:05 INFO - operating with platform_type : mac_ 09:17:05 INFO - Initialising browser for dromaeo_css test... 09:17:05 INFO - TEST-INFO | started process 1959 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/tmpy22f1X/profile http://localhost:49333/getInfo.html) 09:17:07 INFO - PROCESS | 1959 | __metrics Screen width/height:1600/1200 09:17:07 INFO - PROCESS | 1959 | colorDepth:24 09:17:07 INFO - PROCESS | 1959 | Browser inner width/height: 1024/689 09:17:07 INFO - PROCESS | 1959 | __metrics 09:17:08 ERROR - PROCESS | 1959 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3015: TypeError: this.tabs is undefined 09:17:08 INFO - TEST-INFO | 1959: exit 0 09:17:08 INFO - Browser initialized. 09:17:08 INFO - Running cycle 1/1 for dromaeo_css test... 09:17:08 INFO - TEST-INFO | started process 1963 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/tmpy22f1X/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:17:20 INFO - PROCESS | 1963 | RSS: Main: 174682112 09:17:20 INFO - PROCESS | 1963 | 09:18:10 INFO - PROCESS | 1963 | 1482254290299 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 09:20:21 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49333/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49333/tests/dromaeo/cssquery-ext.html) 09:20:23 INFO - PROCESS | 1963 | RSS: Main: 186028032 09:20:23 INFO - PROCESS | 1963 | 09:23:25 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49333/tests/dromaeo/cssquery-ext.html (next: http://localhost:49333/tests/dromaeo/cssquery-jquery.html) 09:23:26 INFO - PROCESS | 1963 | RSS: Main: 198590464 09:23:26 INFO - PROCESS | 1963 | 09:26:27 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49333/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49333/tests/dromaeo/cssquery-mootools.html) 09:26:28 INFO - PROCESS | 1963 | RSS: Main: 200040448 09:26:28 INFO - PROCESS | 1963 | 09:29:30 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49333/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49333/tests/dromaeo/cssquery-prototype.html) 09:29:31 INFO - PROCESS | 1963 | RSS: Main: 204496896 09:29:31 INFO - PROCESS | 1963 | 09:32:33 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49333/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49333/tests/dromaeo/cssquery-yui.html) 09:32:34 INFO - PROCESS | 1963 | RSS: Main: 206544896 09:32:34 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | Cycle 1(1): loaded http://localhost:49333/tests/dromaeo/cssquery-yui.html (next: http://localhost:49333/tests/dromaeo/cssquery-dojo.html) 09:35:37 INFO - PROCESS | 1963 | RSS: Main: 207499264 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | __start_tp_report 09:35:37 INFO - PROCESS | 1963 | _x_x_mozilla_page_load 09:35:37 INFO - PROCESS | 1963 | _x_x_mozilla_page_load_details 09:35:37 INFO - PROCESS | 1963 | |i|pagename|runs| 09:35:37 INFO - PROCESS | 1963 | |0;dojo.html;3069.355435358574;3619.0952261934517;3625.709943204543;3643.6720695137433;3675.191457879267;5965.46310832025;6031.974564324065;6053.6367817930895;6081.756729730817;6109.969450152754;4835.395575553056;6034.849128771772;6099.6340219586855;6110.663913484756;6114.419130182626;5406.675599464025;5455.18172274158;5471.972640136793;5524.502794748471;5563.833085007436;5514.862128446801;5523.447655234485;5525.778968841261;5529.170624406331;5533.418991005947;5363.973180134094;5364.517193452589;5428.782848686048;5537.446255374451;5539.501444869961;5440.91838622421;5495.450454954513;5495.780168793243;5501.449855014486;5556.472135147154;5029.974850125763;5173.456787037345;5334.706591137486;5465.945340546584;5491.121420572689;4354.433923589945;5827.941720582782;5881.441263080043;6003.0695242237525;6103.141293403361;6202.751889924398;6220.564560480768;6288.968555157195;6357.459615932651;6359.300476947532;6409.903851442232;6448.419642232175;6449.516286278501;6462.676866156673;6488.28628850826;4689.484156742756;4990.101781679296;5226.895462090737;5909.6158749681135;5952.761889524457;5283.233931080049;6333.619982801047;6380.872382552323;6438.549301548846;6590.5716128451495;6257.937420625735;6267.905981410283;6310.684465776692;6318.052292156213;6323.9051414228825;5959.612625179349;6430.7749228776765;6433.195850518685;6450.032495125769;6451.1936007999;6185.010398336334;6225.128482012522;6228.439440450381;6259.624422534572;6279.717412716347;5483.424240454695;6157.891579515641;6339.619622822645;6347.238331400262;6352.936470635234;5140.049090918192;5157.277981082651;5164.948350516447;5169.767360468788;5190.97404512975;4491.550844915548;4502.16709908668;4523.11799199153;4617.376654151646;4650.209464391061;6142.262928448615;6236.875262494725;6248.687565621701;6262;6270.529710271748;6394.488440924808;6421.614703117828;6448.258450278185;6449.097126402307;6453.870922581616;6041.788537401258;6112.564273424362;6113.23584551931;6137.622145770991;6177.444030037318;5686;5689.573282003867;5691.658500489983;5740.0815869460685;5740.282464691913;6572.441342485847;6596.8350791230605;6627.5029372797235;6646.136002319668;6655.0682904393425;5731;6238.251409830849;6285.874282514415;6437.227532696106;6454.741810327722;6484.5460817742305;6653.268140504444;6662.433693135944;6671.032700258533;6692.397684208445;6294.8111556653375;6313.40022697843;6320.115183874169;6330.177076979963;6341.143945567474;6221.4089661482085;6272.247330320391;6309.274433440213;6319.494440444845;6390.201224846895;5609.831705048855;5816.9127463088935;6210.596311239755;6243.43809057187;6308.179936608211;6297.590656607306;6298.401651843067;6311.431971122621;6313.179286692701;6317.494600431863;6049.213602231682;6230.7819226326865;6233.345498722569;6290.591111577733;6316.273628532777;6067.878642427215;6106.572539922163;6179.907301390573;6239.1577137085915;6314.305426403;6088.086786981989;6089.786857460145;6091.360407157184;6139.938600614116;6141.631502109888 09:35:37 INFO - PROCESS | 1963 | |1;ext.html;477.18639719278633;491.21405750798726;532.0635681201086;544.1701405356828;546.4262524349432;34005.65994340059;40631;41696;42007;42103.57896421035;44574.10851782963;45060.324095138596;45155.77422112885;45214.77392613041;45256.3211551827;9959.701208963725;10000.949995250014;10144.79710405795;10161.695149145537;10189.949050254738;9902.851457228111;9903.059209375098;9908.405495670248;10004.349717268355;10038.196944244479;9956.303058785888;10009.349392289478;10062.19502439803;10069.395836249849;10083.899161008369;8395.62219700115;9989.650362237287;9992.650257240997;10045.296829221921;10084.294099413044;9989.95105513925;10012.399256044588;10097.394156350643;10101.69694909154;10112.292139550234;41962.79018604887;42762.57237427617;42799.144017119484;43169.35245971313;43245;3310.586176727909;3456.498807672873;3495.405781017233;3558.466230065485;3864.8260828262796;31597.052088437154;32177.51733723996;32237.83881080603;32415;32816.835915820506;3240.54632351471;3313.96686033139;3388.610309814378;3401.2177199244065;3412.5904891412943;483288;486794.1320586784;488549;489402;490105;62024.75950480965;62273.68863155655;62469.68765156236;62524.687376562826;62713;36001.279974400364;36162;36238;37325;38242;18234.908825455786;18392.540186495444;18416.263349465873;18428.815711842977;18466.722999155023;13938.721225575431;13952.651183720489;14051.508197213048;14062.296885155702;14083.295835208199;19871.701924471145;20120.496987575134;20139;20229;20242.89878550598;6972.988916607063;7827.551902897868;7869.685212591547;7999.200179959579;8010.559419231999;863.7970077031893;881.184903963831;1047.8690163729534;1069;1111.5331560744507;31965.68034319627;32043.51934720981;32070;32211.67788322087;32521.349573008407;936.9693337328883;999.9450030248406;1023.0690072034413;1088.2327958789192;1142.7942970265433;13598.38807253676;16803.82373233862;16836.494905152864;16937.745933811002;17016.808823382245;602229;614456;701479;703887;708050;50369.748151259744;59587;61958.69020654868;62157;62166;1108.7006508242891;1366.221253885276;1379.661982814217;1414.2716501001992;1416.178616402484;30702.385952280383;30750;31748.206294842814;31802.886898958426;32303.676963230067;52857.7357113212;53160.4683953171;53207.46792532025;53228.93542129213;53327;604892;606775;607540;610119;612185;27493;27746.306342340795;27772.444551109267;27861.58207626928;28269;40150;49050.0189996191;49449.75275123601;49709.50290497193;51087.48912510827;34970.776022840095;37228.06929826776;38000.23999520049;40708;41783.582164179184;33676;39945.80027099846;40982;41986.79006604947;42469;31129.37741245208;34875;37236;39597;40000.99997500086;33279.667203327655;35353.82323088368;36002;36010.45984310185;36075.458868116475;21782.782172178708;23231.419214519774;26775.732242677324;27004.05485807987;27100.72899270982 09:35:37 INFO - PROCESS | 1963 | |2;jquery.html;342.98971030869075;385.71264408016015;388.12477862420246;395.9762414255147;412.26410856620936;16271.51185464435;21237.893810530924;22265.66601500979;22464.55070898581;22531.98606062727;9576.138147566717;12097.939510302458;12230.266184028964;12448.626541203756;20307.695384569208;4578.267477203648;5658.886822263552;5726.484616384525;5776.653400795944;5807.274090738658;5709.71451427429;5898.469137777599;6225;6283.528735344845;6308.936910630904;5878.76484940604;6274.9058764118345;6294.307626161119;6308.936910630904;6354.745810167611;6072;7031.964840175818;7054.6825392857445;7058;7062.470314726416;5946.494547963428;6100.176476175704;6123.081537769326;6157.322694503601;6183.969080154616;13548.322583870768;13555.932220338835;13650;13708.108972916729;13995.65010874726;2154.34292540775;2355.140373763564;2392.79661228794;2500.5374005808985;2575.665163528748;10262.948685256526;10267.537960791782;10548.419836908966;10686.893131068668;10789.784204315869;1703.8381353771372;1870.8503319734389;2008.5380362516557;2042.2035406191596;2047.2425202675106;121038.39480802539;124915.37542312322;126649.73350266472;127480.7251927478;131510;9532.714018579454;9691.370060946016;11658.00906922921;11861.525538978343;11986.820197697041;14710;15046.473373431878;15096.24518774057;15141.015833970756;15141.091534507965;8711;8965.372423930392;9003.77490562728;9076.319276054322;9081.50051747147;8931.821363572823;8983.505907175168;9020.81958360829;9100.908990910006;9154.221891139328;4543.68194226401;4579.633629309647;4620.53794620542;4691.3432119503295;4761.428628564595;1736.6873962686839;1941.2429152630486;1948.0551932312817;1971.073595410155;2006.5986802639532;819.1826090418621;922.1746536849482;961.8941916389192;970.5195928015536;1005.9195264378832;21336.893315533634;22013.22953696613;22180.00688076829;22381.32856014322;22814;789.6525528767324;969.3892847506027;983.5033308179324;985.6599473181741;1001.2140469731225;8499.660013599387;11614;11774.116941229442;11821;11852.70368240801;606618;612597;613482;613828;615849;101371;134010;138715.30642346723;139811;142357;966.9758256043655;977.130353984954;997.9151772099453;1000.3697670467559;1003.2124782046204;19758;20231.4942126448;20284.98575071211;20441.693374599094;20562;52359;56944.861102778545;57725;58288.417115829994;58321.708391457774;75328;83624;86248;87762.1223787754;88867.55566222387;7203.6758345875605;8197.590120494071;8482.194191551793;8514.403991720768;8626.698065567674;12267.202631828903;13479;13479.528216512375;13594.932025340206;13750.793738094137;11020;11616.419179040846;11932.343721095423;11940.223885447418;12031.578894738643;8458.40791144614;9154.816903662022;9249.815003700023;11713.590024349447;12083.093767967262;11719.765604687687;11750.177487575787;11895.167338286237;12003.699907502032;12229.205101668364;7903.6168670483585;8008.679652814055;8230.465019773696;8348.373871959506;8739.825203496022;8526.337364214167;9449.858252126362;11809.409529523662;11949.163558550817;12038.097142714156 09:35:37 INFO - PROCESS | 1963 | |3;mootools.html;1454.6217983324336;1478.054045410937;1511.0782422722139;1847.473470061033;1849.7410362549238;8190.4266701330935;8377.455465394745;8572.871406928893;9142.360034797559;9163.266938644909;8521.744347669564;8830.95584522078;8857.557122143884;8867.778305542348;8956.820863582741;2368.194813763316;2415.251272105644;2441.426264827764;2445.572024895645;2451.718052423976;2388.653645221442;2415.263344679872;2417.057347634424;2436.8659723715186;2444.5966415541416;2400.7839294463497;2408.674828898094;2411.915582954597;2433.9391515212083;2439.134107391877;2031.6139933412605;2379.3694670912223;2380.7024121984664;2385.725641551218;2416.226807421608;2390.6294524348755;2397.4725560376687;2403.339081752532;2410.3733029412306;2422.8667423291713;8824.558772061435;8885.02264750877;8938.597763100675;8939.463632182089;8939.821203575957;5371.274877891474;5385.272988146589;5423.538999185074;5512.310961129859;5598.384177740445;3473.70473509752;3565.0552603560077;3582.6059133495296;3606.8196590170387;3627.8367473463495;1103.4868786014542;1105.8175401058816;1112.3993043756361;1119.8320251962189;1124.3534967393782;11524.769504609945;11659.533618655243;11687.649370518899;11750.059995200363;11775.352355620438;4330.501992270866;4561.927946932468;4729.574338309569;4932.926006109911;4944.901101978012;10077.193824494023;10218.233632477446;10223.897761022294;10231.641892533875;10233.641822536176;4825.179719447702;5264.657797243167;5401.351837779492;5481.397046324901;5510.834674959758;4541.931871021938;4639.327297541838;4879.194932836113;4994.800207991712;5025.170846810235;4081.6326530612387;4088.2232375848494;4138.317177665712;4177.832886684499;4207.789610519461;1297.928613926243;1321.359140816703;1328.76082305186;1331.8202042724301;1332.7601031814368;804.1757198871087;917.5091326140616;922.4050487435567;928.2388441478058;944.0087907696891;5703.771849126071;5851.268591426072;5903.321118071391;5981.0131328330335;6098.207233059674;451.8938049558351;452.3305507848403;454.538643277074;462.6183398696089;463.75884540038993;3825.2731980923536;3881.3207688654375;3961.227560625708;3988.8005599720477;4007.959920400817;9307.488088155216;10466;10669.946650266698;10783.460826958777;10855.565777368975;10642.148628109733;10709.250352475408;10738.140948724084;10759.7088349397;10807.67576972692;8159.95920020408;8191.795205119801;8287.502749834908;8301.958490207511;8313.542755148525;4939.975300123477;5764.625299355528;5770.163326317576;5781.971090144522;5828.737706803119;9860.950695246478;9866.963968783462;9961.103500684972;10014.298999069995;10088.848667269851;9656.420614763138;10214.489275536342;10244.334118282288;10266.230032747424;10336.844947325646;7071.82320441993;7289.927100728924;7419.258074192538;7585.089789225328;7664.3485303747575;8227.341812655093;8418.705345312885;8520.275776559061;8543.8718419225;8544.487330760174;7254.383377412979;7396;7397.1863095058425;7437.405007599487;7486.438517111347;7324.267573242633;7350.558966462029;7353.8161545961775;7356.030477977504;7482.850342993219;6914.619695916773;7016.824579385556;7048;7068.045813815069;7078.823029424099;4998.925016124688;5006.324146240211;5052.1663925451885;5097.8215762448135;5145.562627176582;5002.824901128443;5089.287499750112;5102.158143906214;5149.330587023663;5174.508421699932 09:35:37 INFO - PROCESS | 1963 | |4;prototype.html;271.96328495653086;314.214463840399;319.2609109910557;325.5101072885307;325.5507399788295;5347.812826551071;5506.476884695948;5610.747516361764;5633.211350410946;5652.660840349582;4448.621867141297;5291.68249905005;5344.232316217067;5405;5625.296837895263;3603.729720270977;4217.279854493857;4275.593818587229;4287.442632457776;4298.441202643652;3060.5256185291205;3703.370427027412;3906.4921560197135;4252.447181866353;4301.763403012833;3518.964810351902;3649.923272634579;3769.6994536884868;3815.9809200953955;4154.480689913761;3306.2891478332153;3541.4333706606817;3869.419587061935;4161.04296011919;4177.644900183488;2990.8504574771173;3632.7820330779973;3641;3641.198936234051;3641.65404286595;4597.839075632337;4741.198344629053;4988.925166122511;5058.747062646889;5364.704941228231;4741.478437371887;4754.976225118887;4756.143894099061;4769.332293478916;4789.904201915977;4941.01179764045;5743;5797.275340582427;5801.274840644919;5830.30036395631;3418.1454636340914;3756.7182461315238;3777.622237776228;3916.3146449371247;3950.9604903951167;5819.330776960662;6035.818925432244;6130.417610327012;6155.815325540196;6199.62802231863;3335.5997280326515;4010.2581022510344;4019.718619696652;4028.4964379452567;4041.7979101045416;3556.466530020466;3913.5695073541888;4091.1204091120553;4095.1981128304046;4104.261232978092;4722.780293262162;4728.503507131702;4741.478437371887;4758.643101767381;4770.710059171617;4793.41817200323;5896.67081502804;5900.822975310747;5916.201312822714;5934;1178.3577950017261;1278.3799857069314;1302.4204229117952;1368.1996032321006;1383.764759990804;902.7246689759686;912.8630705394244;930.134974473746;935.4434111703525;938.0994245524237;5272.312859884877;5513.862153446196;5529.806456774074;5530.253415788898;5561.6663000220115;5586;5942.465178133989;5956.404359564009;5967.166595058017;5969.582129250997;4309.655227581786;5422.48486393792;5481.643693159932;5591.993441180545;5616.550675945915;2561.3991255465335;2653.3101393637407;2669.8531580762856;2671.786257099466;2693.9595906061427;4773.809047638125;4987.020766773207;5027.812901387908;5307.708076055854;5334.745805058911;4691.460482044608;5094.465081166424;5117.309163262987;5155.793768249228;5185;4583.358329833826;4732.952670473252;5239.5284424401225;5254.377815737124;5281.547574417066;4224.4930608327195;4685.882852928567;4922.1541921779335;5116.676408434867;5125.359330083739;5028.949710502849;5329.680219186706;6028.758849645965;6031.914255434064;6080.199875078076;5393.97514472249;6383.96808015957;6405.423511883952;6422.743090276336;6428.55000149985;3553.8578456861437;3873.5351757789244;3943.6845052395165;4101.815418306123;4112.696889741635;4641.86074417768;5762.971185144047;6051.243594550681;6101;6125.693715314305;4879.829205977774;4937.037277730951;5485.945140548543;5666.603337766317;5944.138099975566;4809.759512024455;5187.507186817246;5365.490278423544;5809.477147056785;5906.759580488146;4571.451425828789;4740.952590474051;5247.320857325619;5500.4224556420995;5596.048671725735;4818.4217893852965;5099.954509325654;5202.323697919398;5949.851253718692;5981.940180598138;4301.9354709678755;4971.527704868032;5526.613137080366;5807.332156801853;5845.444682755132 09:35:37 INFO - PROCESS | 1963 | |5;yui.html;709.8438343564417;737.8856277277022;781.7850091224913;842.1662554071463;846.9110743371943;16221.756673649905;16363.918180409097;16482.093484858327;17053.403130890438;17086.060266685345;15235.238238088079;15396.461123860667;15397.84602153978;15418.537443876701;15420.61448463789;702.0136707925373;722.122621015466;865.3553102938304;871.7123349294749;888.7378223424106;828.7928017995501;854.6752234151014;867.9218870301671;894.6823877523483;899.7795540092686;909.4543274035592;911.7538264668535;913.4747520175926;915.1854849184232;918.5269586163131;864.6843901975765;867.6182479708908;875.5097145598485;896.7713233125577;908.5548081440113;648.3484098480997;648.8864448721502;650.4341223135855;673.182083768224;681.8602186551745;15299.311530981022;15343.923280383528;15345.846541534553;15356.846431535654;15370;12269;15394.769078463833;15460.995035322781;15467.303971321206;15558.222088895624;11609.535618575246;11802.409879506076;12023.939880300542;12242.81635775464;12612.873871261261;4867.902641947177;4875.122477953967;4913.14020046494;4944.233643785219;4951.108800415924;114234.42882785533;116891.99999999916;117215;117253.24120138204;119035.21447178212;11460.484278207501;11800.996915262127;11942.462589183508;11980.640580782416;12028.45871935765;22343.66484502734;22765.430864228525;22777.658335124986;22801.429964250696;22856;7859.919474549133;8171.1828817119;8175.182481751777;8220.38347123968;8360.122187170382;3775.6413140751583;4050.8784736457956;4206.390073439334;4403.735775853459;4406.449193850769;3514.3498452786316;3643.763155394891;3649.3431182387426;3657.5428071491065;3657.6708096271464;659.9010148477671;661.7981515637777;680.2177495879778;681.2506243132614;691.4502970138651;546.7703564502918;575.9740811663485;597.4055814464635;606.8998615228526;659.7361055577711;7823.061232652118;8768.649254029768;8769.868451973225;9127.497987610745;9635.518224088768;495.982640607577;561.5732043646776;638.288308535979;642.2646070249538;651.7816531461918;4308.18144552534;4522.23122069249;4541.568550987717;4556.389554372327;4566.771661416916;100693.4895976561;146008.26995864953;149025.25487372495;160146;161888;95262.5236873825;116057.8394216047;131091.34454327667;135384;138798;101183.97632047466;109320;116264.41867790607;116808.41595791967;121250;8228.21831925966;8412.87380689278;9003;9532.571034303335;9950.751231219278;40991;57435;61974.38025619686;62177;65356.34643653502;75936.24063759291;97113;97264;100276;100812.49593751984;10587.470626468492;13521.932390337985;13747.175169489863;13893.305334733424;14219.786703199667;15178.24108794578;15233.542993710207;15678;16032.358705651643;16574.254158563133;14412.711745765235;14559.199244041256;14842.851571484578;14960.40158393652;15465.226738662797;13956.441742330193;14039.649008774863;14413.495527656481;14846.925765371105;14902.552923412315;13975.161490310207;14221.715565688835;14461.13233206011;14647;14911.956163068915;11402.828957565478;11782.882171178178;11913;11947.701307467036;12034.518619255132;11434.313941163557;11509.942450287695;11872.168948173545;12038.939805300917;12060.758784824078 09:35:37 INFO - PROCESS | 1963 | __end_tp_report 09:35:37 INFO - PROCESS | 1963 | __start_cc_report 09:35:37 INFO - PROCESS | 1963 | _x_x_mozilla_cycle_collect,351 09:35:37 INFO - PROCESS | 1963 | __end_cc_report 09:35:37 INFO - PROCESS | 1963 | __startTimestamp1482255337327__endTimestamp 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | ------- Summary: start ------- 09:35:37 INFO - PROCESS | 1963 | Number of tests: 6 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | [#0] dojo.html Cycles:165 Average:5902.71 Median:6141.63 stddev:663.80 (10.8%) stddev-sans-first:627.52 09:35:37 INFO - PROCESS | 1963 | Values: 3069.4 3619.1 3625.7 3643.7 3675.2 5965.5 6032.0 6053.6 6081.8 6110.0 4835.4 6034.8 6099.6 6110.7 6114.4 5406.7 5455.2 5472.0 5524.5 5563.8 5514.9 5523.4 5525.8 5529.2 5533.4 5364.0 5364.5 5428.8 5537.4 5539.5 5440.9 5495.5 5495.8 5501.4 5556.5 5030.0 5173.5 5334.7 5465.9 5491.1 4354.4 5827.9 5881.4 6003.1 6103.1 6202.8 6220.6 6289.0 6357.5 6359.3 6409.9 6448.4 6449.5 6462.7 6488.3 4689.5 4990.1 5226.9 5909.6 5952.8 5283.2 6333.6 6380.9 6438.5 6590.6 6257.9 6267.9 6310.7 6318.1 6323.9 5959.6 6430.8 6433.2 6450.0 6451.2 6185.0 6225.1 6228.4 6259.6 6279.7 5483.4 6157.9 6339.6 6347.2 6352.9 5140.0 5157.3 5164.9 5169.8 5191.0 4491.6 4502.2 4523.1 4617.4 4650.2 6142.3 6236.9 6248.7 6262.0 6270.5 6394.5 6421.6 6448.3 6449.1 6453.9 6041.8 6112.6 6113.2 6137.6 6177.4 5686.0 5689.6 5691.7 5740.1 5740.3 6572.4 6596.8 6627.5 6646.1 6655.1 5731.0 6238.3 6285.9 6437.2 6454.7 6484.5 6653.3 6662.4 6671.0 6692.4 6294.8 6313.4 6320.1 6330.2 6341.1 6221.4 6272.2 6309.3 6319.5 6390.2 5609.8 5816.9 6210.6 6243.4 6308.2 6297.6 6298.4 6311.4 6313.2 6317.5 6049.2 6230.8 6233.3 6290.6 6316.3 6067.9 6106.6 6179.9 6239.2 6314.3 6088.1 6089.8 6091.4 6139.9 6141.6 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | [#1] ext.html Cycles:180 Average:71823.05 Median:36042.96 stddev:158491.63 (439.7%) stddev-sans-first:158845.71 09:35:37 INFO - PROCESS | 1963 | Values: 477.2 491.2 532.1 544.2 546.4 34005.7 40631.0 41696.0 42007.0 42103.6 44574.1 45060.3 45155.8 45214.8 45256.3 9959.7 10000.9 10144.8 10161.7 10189.9 9902.9 9903.1 9908.4 10004.3 10038.2 9956.3 10009.3 10062.2 10069.4 10083.9 8395.6 9989.7 9992.7 10045.3 10084.3 9990.0 10012.4 10097.4 10101.7 10112.3 41962.8 42762.6 42799.1 43169.4 43245.0 3310.6 3456.5 3495.4 3558.5 3864.8 31597.1 32177.5 32237.8 32415.0 32816.8 3240.5 3314.0 3388.6 3401.2 3412.6 483288.0 486794.1 488549.0 489402.0 490105.0 62024.8 62273.7 62469.7 62524.7 62713.0 36001.3 36162.0 36238.0 37325.0 38242.0 18234.9 18392.5 18416.3 18428.8 18466.7 13938.7 13952.7 14051.5 14062.3 14083.3 19871.7 20120.5 20139.0 20229.0 20242.9 6973.0 7827.6 7869.7 7999.2 8010.6 863.8 881.2 1047.9 1069.0 1111.5 31965.7 32043.5 32070.0 32211.7 32521.3 937.0 999.9 1023.1 1088.2 1142.8 13598.4 16803.8 16836.5 16937.7 17016.8 602229.0 614456.0 701479.0 703887.0 708050.0 50369.7 59587.0 61958.7 62157.0 62166.0 1108.7 1366.2 1379.7 1414.3 1416.2 30702.4 30750.0 31748.2 31802.9 32303.7 52857.7 53160.5 53207.5 53228.9 53327.0 604892.0 606775.0 607540.0 610119.0 612185.0 27493.0 27746.3 27772.4 27861.6 28269.0 40150.0 49050.0 49449.8 49709.5 51087.5 34970.8 37228.1 38000.2 40708.0 41783.6 33676.0 39945.8 40982.0 41986.8 42469.0 31129.4 34875.0 37236.0 39597.0 40001.0 33279.7 35353.8 36002.0 36010.5 36075.5 21782.8 23231.4 26775.7 27004.1 27100.7 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | [#2] jquery.html Cycles:180 Average:35731.17 Median:364.35 stddev:102548.00 (28145.4%) stddev-sans-first:102801.25 09:35:37 INFO - PROCESS | 1963 | Values: 343.0 385.7 388.1 396.0 412.3 16271.5 21237.9 22265.7 22464.6 22532.0 9576.1 12097.9 12230.3 12448.6 20307.7 4578.3 5658.9 5726.5 5776.7 5807.3 5709.7 5898.5 6225.0 6283.5 6308.9 5878.8 6274.9 6294.3 6308.9 6354.7 6072.0 7032.0 7054.7 7058.0 7062.5 5946.5 6100.2 6123.1 6157.3 6184.0 13548.3 13555.9 13650.0 13708.1 13995.7 2154.3 2355.1 2392.8 2500.5 2575.7 10262.9 10267.5 10548.4 10686.9 10789.8 1703.8 1870.9 2008.5 2042.2 2047.2 121038.4 124915.4 126649.7 127480.7 131510.0 9532.7 9691.4 11658.0 11861.5 11986.8 14710.0 15046.5 15096.2 15141.0 15141.1 8711.0 8965.4 9003.8 9076.3 9081.5 8931.8 8983.5 9020.8 9100.9 9154.2 4543.7 4579.6 4620.5 4691.3 4761.4 1736.7 1941.2 1948.1 1971.1 2006.6 819.2 922.2 961.9 970.5 1005.9 21336.9 22013.2 22180.0 22381.3 22814.0 789.7 969.4 983.5 985.7 1001.2 8499.7 11614.0 11774.1 11821.0 11852.7 606618.0 612597.0 613482.0 613828.0 615849.0 101371.0 134010.0 138715.3 139811.0 142357.0 967.0 977.1 997.9 1000.4 1003.2 19758.0 20231.5 20285.0 20441.7 20562.0 52359.0 56944.9 57725.0 58288.4 58321.7 75328.0 83624.0 86248.0 87762.1 88867.6 7203.7 8197.6 8482.2 8514.4 8626.7 12267.2 13479.0 13479.5 13594.9 13750.8 11020.0 11616.4 11932.3 11940.2 12031.6 8458.4 9154.8 9249.8 11713.6 12083.1 11719.8 11750.2 11895.2 12003.7 12229.2 7903.6 8008.7 8230.5 8348.4 8739.8 8526.3 9449.9 11809.4 11949.2 12038.1 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | [#3] mootools.html Cycles:180 Average:5734.53 Median:4852.19 stddev:3216.64 (66.3%) stddev-sans-first:3209.58 09:35:37 INFO - PROCESS | 1963 | Values: 1454.6 1478.1 1511.1 1847.5 1849.7 8190.4 8377.5 8572.9 9142.4 9163.3 8521.7 8831.0 8857.6 8867.8 8956.8 2368.2 2415.3 2441.4 2445.6 2451.7 2388.7 2415.3 2417.1 2436.9 2444.6 2400.8 2408.7 2411.9 2433.9 2439.1 2031.6 2379.4 2380.7 2385.7 2416.2 2390.6 2397.5 2403.3 2410.4 2422.9 8824.6 8885.0 8938.6 8939.5 8939.8 5371.3 5385.3 5423.5 5512.3 5598.4 3473.7 3565.1 3582.6 3606.8 3627.8 1103.5 1105.8 1112.4 1119.8 1124.4 11524.8 11659.5 11687.6 11750.1 11775.4 4330.5 4561.9 4729.6 4932.9 4944.9 10077.2 10218.2 10223.9 10231.6 10233.6 4825.2 5264.7 5401.4 5481.4 5510.8 4541.9 4639.3 4879.2 4994.8 5025.2 4081.6 4088.2 4138.3 4177.8 4207.8 1297.9 1321.4 1328.8 1331.8 1332.8 804.2 917.5 922.4 928.2 944.0 5703.8 5851.3 5903.3 5981.0 6098.2 451.9 452.3 454.5 462.6 463.8 3825.3 3881.3 3961.2 3988.8 4008.0 9307.5 10466.0 10669.9 10783.5 10855.6 10642.1 10709.3 10738.1 10759.7 10807.7 8160.0 8191.8 8287.5 8302.0 8313.5 4940.0 5764.6 5770.2 5782.0 5828.7 9861.0 9867.0 9961.1 10014.3 10088.8 9656.4 10214.5 10244.3 10266.2 10336.8 7071.8 7289.9 7419.3 7585.1 7664.3 8227.3 8418.7 8520.3 8543.9 8544.5 7254.4 7396.0 7397.2 7437.4 7486.4 7324.3 7350.6 7353.8 7356.0 7482.9 6914.6 7016.8 7048.0 7068.0 7078.8 4998.9 5006.3 5052.2 5097.8 5145.6 5002.8 5089.3 5102.2 5149.3 5174.5 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | [#4] prototype.html Cycles:180 Average:4535.94 Median:4956.27 stddev:1423.65 (28.7%) stddev-sans-first:1391.21 09:35:37 INFO - PROCESS | 1963 | Values: 272.0 314.2 319.3 325.5 325.6 5347.8 5506.5 5610.7 5633.2 5652.7 4448.6 5291.7 5344.2 5405.0 5625.3 3603.7 4217.3 4275.6 4287.4 4298.4 3060.5 3703.4 3906.5 4252.4 4301.8 3519.0 3649.9 3769.7 3816.0 4154.5 3306.3 3541.4 3869.4 4161.0 4177.6 2990.9 3632.8 3641.0 3641.2 3641.7 4597.8 4741.2 4988.9 5058.7 5364.7 4741.5 4755.0 4756.1 4769.3 4789.9 4941.0 5743.0 5797.3 5801.3 5830.3 3418.1 3756.7 3777.6 3916.3 3951.0 5819.3 6035.8 6130.4 6155.8 6199.6 3335.6 4010.3 4019.7 4028.5 4041.8 3556.5 3913.6 4091.1 4095.2 4104.3 4722.8 4728.5 4741.5 4758.6 4770.7 4793.4 5896.7 5900.8 5916.2 5934.0 1178.4 1278.4 1302.4 1368.2 1383.8 902.7 912.9 930.1 935.4 938.1 5272.3 5513.9 5529.8 5530.3 5561.7 5586.0 5942.5 5956.4 5967.2 5969.6 4309.7 5422.5 5481.6 5592.0 5616.6 2561.4 2653.3 2669.9 2671.8 2694.0 4773.8 4987.0 5027.8 5307.7 5334.7 4691.5 5094.5 5117.3 5155.8 5185.0 4583.4 4733.0 5239.5 5254.4 5281.5 4224.5 4685.9 4922.2 5116.7 5125.4 5028.9 5329.7 6028.8 6031.9 6080.2 5394.0 6384.0 6405.4 6422.7 6428.6 3553.9 3873.5 3943.7 4101.8 4112.7 4641.9 5763.0 6051.2 6101.0 6125.7 4879.8 4937.0 5485.9 5666.6 5944.1 4809.8 5187.5 5365.5 5809.5 5906.8 4571.5 4741.0 5247.3 5500.4 5596.0 4818.4 5100.0 5202.3 5949.9 5981.9 4301.9 4971.5 5526.6 5807.3 5845.4 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - PROCESS | 1963 | [#5] yui.html Cycles:180 Average:25102.33 Median:13185.17 stddev:39605.00 (300.4%) stddev-sans-first:39673.76 09:35:37 INFO - PROCESS | 1963 | Values: 709.8 737.9 781.8 842.2 846.9 16221.8 16363.9 16482.1 17053.4 17086.1 15235.2 15396.5 15397.8 15418.5 15420.6 702.0 722.1 865.4 871.7 888.7 828.8 854.7 867.9 894.7 899.8 909.5 911.8 913.5 915.2 918.5 864.7 867.6 875.5 896.8 908.6 648.3 648.9 650.4 673.2 681.9 15299.3 15343.9 15345.8 15356.8 15370.0 12269.0 15394.8 15461.0 15467.3 15558.2 11609.5 11802.4 12023.9 12242.8 12612.9 4867.9 4875.1 4913.1 4944.2 4951.1 114234.4 116892.0 117215.0 117253.2 119035.2 11460.5 11801.0 11942.5 11980.6 12028.5 22343.7 22765.4 22777.7 22801.4 22856.0 7859.9 8171.2 8175.2 8220.4 8360.1 3775.6 4050.9 4206.4 4403.7 4406.4 3514.3 3643.8 3649.3 3657.5 3657.7 659.9 661.8 680.2 681.3 691.5 546.8 576.0 597.4 606.9 659.7 7823.1 8768.6 8769.9 9127.5 9635.5 496.0 561.6 638.3 642.3 651.8 4308.2 4522.2 4541.6 4556.4 4566.8 100693.5 146008.3 149025.3 160146.0 161888.0 95262.5 116057.8 131091.3 135384.0 138798.0 101184.0 109320.0 116264.4 116808.4 121250.0 8228.2 8412.9 9003.0 9532.6 9950.8 40991.0 57435.0 61974.4 62177.0 65356.3 75936.2 97113.0 97264.0 100276.0 100812.5 10587.5 13521.9 13747.2 13893.3 14219.8 15178.2 15233.5 15678.0 16032.4 16574.3 14412.7 14559.2 14842.9 14960.4 15465.2 13956.4 14039.6 14413.5 14846.9 14902.6 13975.2 14221.7 14461.1 14647.0 14912.0 11402.8 11782.9 11913.0 11947.7 12034.5 11434.3 11509.9 11872.2 12038.9 12060.8 09:35:37 INFO - PROCESS | 1963 | -------- Summary: end -------- 09:35:37 INFO - PROCESS | 1963 | 09:35:37 INFO - TEST-INFO | 1963: exit 0 09:35:37 INFO - TEST-OK | dromaeo_css | took 1112526ms 09:35:37 INFO - TEST-START | kraken 09:35:37 INFO - operating with platform_type : mac_ 09:35:37 INFO - Initialising browser for kraken test... 09:35:37 INFO - TEST-INFO | started process 1969 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/tmpsyjcIR/profile http://localhost:49333/getInfo.html) 09:35:40 INFO - PROCESS | 1969 | __metrics Screen width/height:1600/1200 09:35:40 INFO - PROCESS | 1969 | colorDepth:24 09:35:40 INFO - PROCESS | 1969 | Browser inner width/height: 1024/689 09:35:40 INFO - PROCESS | 1969 | __metrics 09:35:40 ERROR - PROCESS | 1969 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3015: TypeError: this.tabs is undefined 09:35:40 INFO - TEST-INFO | 1969: exit 0 09:35:40 INFO - Browser initialized. 09:35:40 INFO - Running cycle 1/1 for kraken test... 09:35:40 INFO - TEST-INFO | started process 1972 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/tmpsyjcIR/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:35:53 INFO - PROCESS | 1972 | RSS: Main: 174743552 09:35:53 INFO - PROCESS | 1972 | 09:35:55 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49333/tests/kraken/driver.html?testName=audio-beat-detection) 09:35:56 INFO - PROCESS | 1972 | RSS: Main: 186818560 09:35:56 INFO - PROCESS | 1972 | 09:35:59 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49333/tests/kraken/driver.html?testName=audio-dft) 09:36:00 INFO - PROCESS | 1972 | RSS: Main: 194379776 09:36:00 INFO - PROCESS | 1972 | 09:36:03 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49333/tests/kraken/driver.html?testName=audio-fft) 09:36:03 INFO - PROCESS | 1972 | RSS: Main: 198103040 09:36:03 INFO - PROCESS | 1972 | 09:36:05 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49333/tests/kraken/driver.html?testName=audio-oscillator) 09:36:06 INFO - PROCESS | 1972 | RSS: Main: 199471104 09:36:06 INFO - PROCESS | 1972 | 09:36:08 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49333/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:36:09 INFO - PROCESS | 1972 | RSS: Main: 199442432 09:36:09 INFO - PROCESS | 1972 | 09:36:11 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49333/tests/kraken/driver.html?testName=imaging-darkroom) 09:36:12 INFO - PROCESS | 1972 | RSS: Main: 200237056 09:36:12 INFO - PROCESS | 1972 | 09:36:15 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49333/tests/kraken/driver.html?testName=imaging-desaturate) 09:36:16 INFO - PROCESS | 1972 | RSS: Main: 199987200 09:36:16 INFO - PROCESS | 1972 | 09:36:19 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49333/tests/kraken/driver.html?testName=json-parse-financial) 09:36:19 INFO - PROCESS | 1972 | RSS: Main: 200630272 09:36:19 INFO - PROCESS | 1972 | 09:36:21 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49333/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:36:21 INFO - PROCESS | 1972 | RSS: Main: 200118272 09:36:21 INFO - PROCESS | 1972 | 09:36:23 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49333/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:36:24 INFO - PROCESS | 1972 | RSS: Main: 200273920 09:36:24 INFO - PROCESS | 1972 | 09:36:26 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49333/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:36:27 INFO - PROCESS | 1972 | RSS: Main: 200155136 09:36:27 INFO - PROCESS | 1972 | 09:36:30 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49333/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:36:30 INFO - PROCESS | 1972 | RSS: Main: 200241152 09:36:30 INFO - PROCESS | 1972 | 09:36:33 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49333/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:36:34 INFO - PROCESS | 1972 | RSS: Main: 200650752 09:36:34 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | Cycle 1(1): loaded http://localhost:49333/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49333/tests/kraken/driver.html?testName=ai-astar) 09:36:36 INFO - PROCESS | 1972 | RSS: Main: 202199040 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | __start_tp_report 09:36:36 INFO - PROCESS | 1972 | _x_x_mozilla_page_load 09:36:36 INFO - PROCESS | 1972 | _x_x_mozilla_page_load_details 09:36:36 INFO - PROCESS | 1972 | |i|pagename|runs| 09:36:36 INFO - PROCESS | 1972 | |0;ai-astar;106;118;120;117;118;117;117;96;174;173 09:36:36 INFO - PROCESS | 1972 | |1;audio-beat-detection;136;144;96;146;93;102;117;111;175;145 09:36:36 INFO - PROCESS | 1972 | |2;audio-dft;182;202;197;205;197;193;193;197;206;198 09:36:36 INFO - PROCESS | 1972 | |3;audio-fft;82;59;60;91;58;59;60;64;70;64 09:36:36 INFO - PROCESS | 1972 | |4;audio-oscillator;87;69;88;77;81;99;123;60;101;98 09:36:36 INFO - PROCESS | 1972 | |5;imaging-gaussian-blur;103;133;92;89;93;132;92;90;93;101 09:36:36 INFO - PROCESS | 1972 | |6;imaging-darkroom;110;96;97;97;97;96;97;105;134;97 09:36:36 INFO - PROCESS | 1972 | |7;imaging-desaturate;94;92;91;90;139;86;143;141;92;96 09:36:36 INFO - PROCESS | 1972 | |8;json-parse-financial;55;56;57;77;90;58;58;58;58;59 09:36:36 INFO - PROCESS | 1972 | |9;json-stringify-tinderbox;65;72;65;82;77;104;60;80;92;102 09:36:36 INFO - PROCESS | 1972 | |10;stanford-crypto-aes;80;84;86;83;87;85;82;80;83;90 09:36:36 INFO - PROCESS | 1972 | |11;stanford-crypto-ccm;136;139;139;139;147;144;150;168;183;174 09:36:36 INFO - PROCESS | 1972 | |12;stanford-crypto-pbkdf2;161;156;235;205;163;165;162;166;162;169 09:36:36 INFO - PROCESS | 1972 | |13;stanford-crypto-sha256-iterative;68;65;67;68;68;67;66;68;67;66 09:36:36 INFO - PROCESS | 1972 | __end_tp_report 09:36:36 INFO - PROCESS | 1972 | __start_cc_report 09:36:36 INFO - PROCESS | 1972 | _x_x_mozilla_cycle_collect,899 09:36:36 INFO - PROCESS | 1972 | __end_cc_report 09:36:36 INFO - PROCESS | 1972 | __startTimestamp1482255396275__endTimestamp 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | ------- Summary: start ------- 09:36:36 INFO - PROCESS | 1972 | Number of tests: 14 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#0] ai-astar Cycles:10 Average:125.60 Median:119.00 stddev:26.29 (22.1%) stddev-sans-first:26.91 09:36:36 INFO - PROCESS | 1972 | Values: 106.0 118.0 120.0 117.0 118.0 117.0 117.0 96.0 174.0 173.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#1] audio-beat-detection Cycles:10 Average:126.50 Median:145.50 stddev:26.78 (18.4%) stddev-sans-first:28.18 09:36:36 INFO - PROCESS | 1972 | Values: 136.0 144.0 96.0 146.0 93.0 102.0 117.0 111.0 175.0 145.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#2] audio-dft Cycles:10 Average:197.00 Median:197.50 stddev:6.90 (3.5%) stddev-sans-first:4.72 09:36:36 INFO - PROCESS | 1972 | Values: 182.0 202.0 197.0 205.0 197.0 193.0 193.0 197.0 206.0 198.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#3] audio-fft Cycles:10 Average:66.70 Median:64.00 stddev:11.23 (17.5%) stddev-sans-first:10.45 09:36:36 INFO - PROCESS | 1972 | Values: 82.0 59.0 60.0 91.0 58.0 59.0 60.0 64.0 70.0 64.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#4] audio-oscillator Cycles:10 Average:88.30 Median:84.00 stddev:18.04 (21.5%) stddev-sans-first:19.13 09:36:36 INFO - PROCESS | 1972 | Values: 87.0 69.0 88.0 77.0 81.0 99.0 123.0 60.0 101.0 98.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#5] imaging-gaussian-blur Cycles:10 Average:101.80 Median:91.00 stddev:16.79 (18.5%) stddev-sans-first:17.80 09:36:36 INFO - PROCESS | 1972 | Values: 103.0 133.0 92.0 89.0 93.0 132.0 92.0 90.0 93.0 101.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#6] imaging-darkroom Cycles:10 Average:102.60 Median:97.00 stddev:11.97 (12.3%) stddev-sans-first:12.40 09:36:36 INFO - PROCESS | 1972 | Values: 110.0 96.0 97.0 97.0 97.0 96.0 97.0 105.0 134.0 97.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#7] imaging-desaturate Cycles:10 Average:106.40 Median:91.50 stddev:24.03 (26.3%) stddev-sans-first:25.07 09:36:36 INFO - PROCESS | 1972 | Values: 94.0 92.0 91.0 90.0 139.0 86.0 143.0 141.0 92.0 96.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#8] json-parse-financial Cycles:10 Average:62.60 Median:58.00 stddev:11.49 (19.8%) stddev-sans-first:11.85 09:36:36 INFO - PROCESS | 1972 | Values: 55.0 56.0 57.0 77.0 90.0 58.0 58.0 58.0 58.0 59.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#9] json-stringify-tinderbox Cycles:10 Average:79.90 Median:74.50 stddev:15.39 (20.7%) stddev-sans-first:15.35 09:36:36 INFO - PROCESS | 1972 | Values: 65.0 72.0 65.0 82.0 77.0 104.0 60.0 80.0 92.0 102.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#10] stanford-crypto-aes Cycles:10 Average:84.00 Median:84.50 stddev:3.13 (3.7%) stddev-sans-first:2.96 09:36:36 INFO - PROCESS | 1972 | Values: 80.0 84.0 86.0 83.0 87.0 85.0 82.0 80.0 83.0 90.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#11] stanford-crypto-ccm Cycles:10 Average:151.90 Median:148.50 stddev:16.86 (11.4%) stddev-sans-first:16.87 09:36:36 INFO - PROCESS | 1972 | Values: 136.0 139.0 139.0 139.0 147.0 144.0 150.0 168.0 183.0 174.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:174.40 Median:165.50 stddev:25.28 (15.3%) stddev-sans-first:26.35 09:36:36 INFO - PROCESS | 1972 | Values: 161.0 156.0 235.0 205.0 163.0 165.0 162.0 166.0 162.0 169.0 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - PROCESS | 1972 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.00 Median:67.50 stddev:1.05 (1.6%) stddev-sans-first:1.05 09:36:36 INFO - PROCESS | 1972 | Values: 68.0 65.0 67.0 68.0 68.0 67.0 66.0 68.0 67.0 66.0 09:36:36 INFO - PROCESS | 1972 | -------- Summary: end -------- 09:36:36 INFO - PROCESS | 1972 | 09:36:36 INFO - TEST-INFO | 1972: exit 0 09:36:37 INFO - TEST-OK | kraken | took 59188ms 09:36:37 INFO - SUITE-END | took 1171s 09:36:37 INFO - Completed test suite (00:19:32) 09:36:37 INFO - javascript benchmark 09:36:37 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7444.774043397498, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3069.355435358574, 3619.0952261934517, 3625.709943204543, 3643.6720695137433, 3675.191457879267, 5965.46310832025, 6031.974564324065, 6053.6367817930895, 6081.756729730817, 6109.969450152754, 4835.395575553056, 6034.849128771772, 6099.6340219586855, 6110.663913484756, 6114.419130182626, 5406.675599464025, 5455.18172274158, 5471.972640136793, 5524.502794748471, 5563.833085007436, 5514.862128446801, 5523.447655234485, 5525.778968841261, 5529.170624406331, 5533.418991005947, 5363.973180134094, 5364.517193452589, 5428.782848686048, 5537.446255374451, 5539.501444869961, 5440.91838622421, 5495.450454954513, 5495.780168793243, 5501.449855014486, 5556.472135147154, 5029.974850125763, 5173.456787037345, 5334.706591137486, 5465.945340546584, 5491.121420572689, 4354.433923589945, 5827.941720582782, 5881.441263080043, 6003.0695242237525, 6103.141293403361, 6202.751889924398, 6220.564560480768, 6288.968555157195, 6357.459615932651, 6359.300476947532, 6409.903851442232, 6448.419642232175, 6449.516286278501, 6462.676866156673, 6488.28628850826, 4689.484156742756, 4990.101781679296, 5226.895462090737, 5909.6158749681135, 5952.761889524457, 5283.233931080049, 6333.619982801047, 6380.872382552323, 6438.549301548846, 6590.5716128451495, 6257.937420625735, 6267.905981410283, 6310.684465776692, 6318.052292156213, 6323.9051414228825, 5959.612625179349, 6430.7749228776765, 6433.195850518685, 6450.032495125769, 6451.1936007999, 6185.010398336334, 6225.128482012522, 6228.439440450381, 6259.624422534572, 6279.717412716347, 5483.424240454695, 6157.891579515641, 6339.619622822645, 6347.238331400262, 6352.936470635234, 5140.049090918192, 5157.277981082651, 5164.948350516447, 5169.767360468788, 5190.97404512975, 4491.550844915548, 4502.16709908668, 4523.11799199153, 4617.376654151646, 4650.209464391061, 6142.262928448615, 6236.875262494725, 6248.687565621701, 6262.0, 6270.529710271748, 6394.488440924808, 6421.614703117828, 6448.258450278185, 6449.097126402307, 6453.870922581616, 6041.788537401258, 6112.564273424362, 6113.23584551931, 6137.622145770991, 6177.444030037318, 5686.0, 5689.573282003867, 5691.658500489983, 5740.0815869460685, 5740.282464691913, 6572.441342485847, 6596.8350791230605, 6627.5029372797235, 6646.136002319668, 6655.0682904393425, 5731.0, 6238.251409830849, 6285.874282514415, 6437.227532696106, 6454.741810327722, 6484.5460817742305, 6653.268140504444, 6662.433693135944, 6671.032700258533, 6692.397684208445, 6294.8111556653375, 6313.40022697843, 6320.115183874169, 6330.177076979963, 6341.143945567474, 6221.4089661482085, 6272.247330320391, 6309.274433440213, 6319.494440444845, 6390.201224846895, 5609.831705048855, 5816.9127463088935, 6210.596311239755, 6243.43809057187, 6308.179936608211, 6297.590656607306, 6298.401651843067, 6311.431971122621, 6313.179286692701, 6317.494600431863, 6049.213602231682, 6230.7819226326865, 6233.345498722569, 6290.591111577733, 6316.273628532777, 6067.878642427215, 6106.572539922163, 6179.907301390573, 6239.1577137085915, 6314.305426403, 6088.086786981989, 6089.786857460145, 6091.360407157184, 6139.938600614116, 6141.631502109888], "value": 5863.424129316655, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [477.18639719278633, 491.21405750798726, 532.0635681201086, 544.1701405356828, 546.4262524349432, 34005.65994340059, 40631.0, 41696.0, 42007.0, 42103.57896421035, 44574.10851782963, 45060.324095138596, 45155.77422112885, 45214.77392613041, 45256.3211551827, 9959.701208963725, 10000.949995250014, 10144.79710405795, 10161.695149145537, 10189.949050254738, 9902.851457228111, 9903.059209375098, 9908.405495670248, 10004.349717268355, 10038.196944244479, 9956.303058785888, 10009.349392289478, 10062.19502439803, 10069.395836249849, 10083.899161008369, 8395.62219700115, 9989.650362237287, 9992.650257240997, 10045.296829221921, 10084.294099413044, 9989.95105513925, 10012.399256044588, 10097.394156350643, 10101.69694909154, 10112.292139550234, 41962.79018604887, 42762.57237427617, 42799.144017119484, 43169.35245971313, 43245.0, 3310.586176727909, 3456.498807672873, 3495.405781017233, 3558.466230065485, 3864.8260828262796, 31597.052088437154, 32177.51733723996, 32237.83881080603, 32415.0, 32816.835915820506, 3240.54632351471, 3313.96686033139, 3388.610309814378, 3401.2177199244065, 3412.5904891412943, 483288.0, 486794.1320586784, 488549.0, 489402.0, 490105.0, 62024.75950480965, 62273.68863155655, 62469.68765156236, 62524.687376562826, 62713.0, 36001.279974400364, 36162.0, 36238.0, 37325.0, 38242.0, 18234.908825455786, 18392.540186495444, 18416.263349465873, 18428.815711842977, 18466.722999155023, 13938.721225575431, 13952.651183720489, 14051.508197213048, 14062.296885155702, 14083.295835208199, 19871.701924471145, 20120.496987575134, 20139.0, 20229.0, 20242.89878550598, 6972.988916607063, 7827.551902897868, 7869.685212591547, 7999.200179959579, 8010.559419231999, 863.7970077031893, 881.184903963831, 1047.8690163729534, 1069.0, 1111.5331560744507, 31965.68034319627, 32043.51934720981, 32070.0, 32211.67788322087, 32521.349573008407, 936.9693337328883, 999.9450030248406, 1023.0690072034413, 1088.2327958789192, 1142.7942970265433, 13598.38807253676, 16803.82373233862, 16836.494905152864, 16937.745933811002, 17016.808823382245, 602229.0, 614456.0, 701479.0, 703887.0, 708050.0, 50369.748151259744, 59587.0, 61958.69020654868, 62157.0, 62166.0, 1108.7006508242891, 1366.221253885276, 1379.661982814217, 1414.2716501001992, 1416.178616402484, 30702.385952280383, 30750.0, 31748.206294842814, 31802.886898958426, 32303.676963230067, 52857.7357113212, 53160.4683953171, 53207.46792532025, 53228.93542129213, 53327.0, 604892.0, 606775.0, 607540.0, 610119.0, 612185.0, 27493.0, 27746.306342340795, 27772.444551109267, 27861.58207626928, 28269.0, 40150.0, 49050.0189996191, 49449.75275123601, 49709.50290497193, 51087.48912510827, 34970.776022840095, 37228.06929826776, 38000.23999520049, 40708.0, 41783.582164179184, 33676.0, 39945.80027099846, 40982.0, 41986.79006604947, 42469.0, 31129.37741245208, 34875.0, 37236.0, 39597.0, 40000.99997500086, 33279.667203327655, 35353.82323088368, 36002.0, 36010.45984310185, 36075.458868116475, 21782.782172178708, 23231.419214519774, 26775.732242677324, 27004.05485807987, 27100.72899270982], "value": 20361.441703286946, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [342.98971030869075, 385.71264408016015, 388.12477862420246, 395.9762414255147, 412.26410856620936, 16271.51185464435, 21237.893810530924, 22265.66601500979, 22464.55070898581, 22531.98606062727, 9576.138147566717, 12097.939510302458, 12230.266184028964, 12448.626541203756, 20307.695384569208, 4578.267477203648, 5658.886822263552, 5726.484616384525, 5776.653400795944, 5807.274090738658, 5709.71451427429, 5898.469137777599, 6225.0, 6283.528735344845, 6308.936910630904, 5878.76484940604, 6274.9058764118345, 6294.307626161119, 6308.936910630904, 6354.745810167611, 6072.0, 7031.964840175818, 7054.6825392857445, 7058.0, 7062.470314726416, 5946.494547963428, 6100.176476175704, 6123.081537769326, 6157.322694503601, 6183.969080154616, 13548.322583870768, 13555.932220338835, 13650.0, 13708.108972916729, 13995.65010874726, 2154.34292540775, 2355.140373763564, 2392.79661228794, 2500.5374005808985, 2575.665163528748, 10262.948685256526, 10267.537960791782, 10548.419836908966, 10686.893131068668, 10789.784204315869, 1703.8381353771372, 1870.8503319734389, 2008.5380362516557, 2042.2035406191596, 2047.2425202675106, 121038.39480802539, 124915.37542312322, 126649.73350266472, 127480.7251927478, 131510.0, 9532.714018579454, 9691.370060946016, 11658.00906922921, 11861.525538978343, 11986.820197697041, 14710.0, 15046.473373431878, 15096.24518774057, 15141.015833970756, 15141.091534507965, 8711.0, 8965.372423930392, 9003.77490562728, 9076.319276054322, 9081.50051747147, 8931.821363572823, 8983.505907175168, 9020.81958360829, 9100.908990910006, 9154.221891139328, 4543.68194226401, 4579.633629309647, 4620.53794620542, 4691.3432119503295, 4761.428628564595, 1736.6873962686839, 1941.2429152630486, 1948.0551932312817, 1971.073595410155, 2006.5986802639532, 819.1826090418621, 922.1746536849482, 961.8941916389192, 970.5195928015536, 1005.9195264378832, 21336.893315533634, 22013.22953696613, 22180.00688076829, 22381.32856014322, 22814.0, 789.6525528767324, 969.3892847506027, 983.5033308179324, 985.6599473181741, 1001.2140469731225, 8499.660013599387, 11614.0, 11774.116941229442, 11821.0, 11852.70368240801, 606618.0, 612597.0, 613482.0, 613828.0, 615849.0, 101371.0, 134010.0, 138715.30642346723, 139811.0, 142357.0, 966.9758256043655, 977.130353984954, 997.9151772099453, 1000.3697670467559, 1003.2124782046204, 19758.0, 20231.4942126448, 20284.98575071211, 20441.693374599094, 20562.0, 52359.0, 56944.861102778545, 57725.0, 58288.417115829994, 58321.708391457774, 75328.0, 83624.0, 86248.0, 87762.1223787754, 88867.55566222387, 7203.6758345875605, 8197.590120494071, 8482.194191551793, 8514.403991720768, 8626.698065567674, 12267.202631828903, 13479.0, 13479.528216512375, 13594.932025340206, 13750.793738094137, 11020.0, 11616.419179040846, 11932.343721095423, 11940.223885447418, 12031.578894738643, 8458.40791144614, 9154.816903662022, 9249.815003700023, 11713.590024349447, 12083.093767967262, 11719.765604687687, 11750.177487575787, 11895.167338286237, 12003.699907502032, 12229.205101668364, 7903.6168670483585, 8008.679652814055, 8230.465019773696, 8348.373871959506, 8739.825203496022, 8526.337364214167, 9449.858252126362, 11809.409529523662, 11949.163558550817, 12038.097142714156], "value": 9585.020161416009, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1454.6217983324336, 1478.054045410937, 1511.0782422722139, 1847.473470061033, 1849.7410362549238, 8190.4266701330935, 8377.455465394745, 8572.871406928893, 9142.360034797559, 9163.266938644909, 8521.744347669564, 8830.95584522078, 8857.557122143884, 8867.778305542348, 8956.820863582741, 2368.194813763316, 2415.251272105644, 2441.426264827764, 2445.572024895645, 2451.718052423976, 2388.653645221442, 2415.263344679872, 2417.057347634424, 2436.8659723715186, 2444.5966415541416, 2400.7839294463497, 2408.674828898094, 2411.915582954597, 2433.9391515212083, 2439.134107391877, 2031.6139933412605, 2379.3694670912223, 2380.7024121984664, 2385.725641551218, 2416.226807421608, 2390.6294524348755, 2397.4725560376687, 2403.339081752532, 2410.3733029412306, 2422.8667423291713, 8824.558772061435, 8885.02264750877, 8938.597763100675, 8939.463632182089, 8939.821203575957, 5371.274877891474, 5385.272988146589, 5423.538999185074, 5512.310961129859, 5598.384177740445, 3473.70473509752, 3565.0552603560077, 3582.6059133495296, 3606.8196590170387, 3627.8367473463495, 1103.4868786014542, 1105.8175401058816, 1112.3993043756361, 1119.8320251962189, 1124.3534967393782, 11524.769504609945, 11659.533618655243, 11687.649370518899, 11750.059995200363, 11775.352355620438, 4330.501992270866, 4561.927946932468, 4729.574338309569, 4932.926006109911, 4944.901101978012, 10077.193824494023, 10218.233632477446, 10223.897761022294, 10231.641892533875, 10233.641822536176, 4825.179719447702, 5264.657797243167, 5401.351837779492, 5481.397046324901, 5510.834674959758, 4541.931871021938, 4639.327297541838, 4879.194932836113, 4994.800207991712, 5025.170846810235, 4081.6326530612387, 4088.2232375848494, 4138.317177665712, 4177.832886684499, 4207.789610519461, 1297.928613926243, 1321.359140816703, 1328.76082305186, 1331.8202042724301, 1332.7601031814368, 804.1757198871087, 917.5091326140616, 922.4050487435567, 928.2388441478058, 944.0087907696891, 5703.771849126071, 5851.268591426072, 5903.321118071391, 5981.0131328330335, 6098.207233059674, 451.8938049558351, 452.3305507848403, 454.538643277074, 462.6183398696089, 463.75884540038993, 3825.2731980923536, 3881.3207688654375, 3961.227560625708, 3988.8005599720477, 4007.959920400817, 9307.488088155216, 10466.0, 10669.946650266698, 10783.460826958777, 10855.565777368975, 10642.148628109733, 10709.250352475408, 10738.140948724084, 10759.7088349397, 10807.67576972692, 8159.95920020408, 8191.795205119801, 8287.502749834908, 8301.958490207511, 8313.542755148525, 4939.975300123477, 5764.625299355528, 5770.163326317576, 5781.971090144522, 5828.737706803119, 9860.950695246478, 9866.963968783462, 9961.103500684972, 10014.298999069995, 10088.848667269851, 9656.420614763138, 10214.489275536342, 10244.334118282288, 10266.230032747424, 10336.844947325646, 7071.82320441993, 7289.927100728924, 7419.258074192538, 7585.089789225328, 7664.3485303747575, 8227.341812655093, 8418.705345312885, 8520.275776559061, 8543.8718419225, 8544.487330760174, 7254.383377412979, 7396.0, 7397.1863095058425, 7437.405007599487, 7486.438517111347, 7324.267573242633, 7350.558966462029, 7353.8161545961775, 7356.030477977504, 7482.850342993219, 6914.619695916773, 7016.824579385556, 7048.0, 7068.045813815069, 7078.823029424099, 4998.925016124688, 5006.324146240211, 5052.1663925451885, 5097.8215762448135, 5145.562627176582, 5002.824901128443, 5089.287499750112, 5102.158143906214, 5149.330587023663, 5174.508421699932], "value": 4543.799398219798, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [271.96328495653086, 314.214463840399, 319.2609109910557, 325.5101072885307, 325.5507399788295, 5347.812826551071, 5506.476884695948, 5610.747516361764, 5633.211350410946, 5652.660840349582, 4448.621867141297, 5291.68249905005, 5344.232316217067, 5405.0, 5625.296837895263, 3603.729720270977, 4217.279854493857, 4275.593818587229, 4287.442632457776, 4298.441202643652, 3060.5256185291205, 3703.370427027412, 3906.4921560197135, 4252.447181866353, 4301.763403012833, 3518.964810351902, 3649.923272634579, 3769.6994536884868, 3815.9809200953955, 4154.480689913761, 3306.2891478332153, 3541.4333706606817, 3869.419587061935, 4161.04296011919, 4177.644900183488, 2990.8504574771173, 3632.7820330779973, 3641.0, 3641.198936234051, 3641.65404286595, 4597.839075632337, 4741.198344629053, 4988.925166122511, 5058.747062646889, 5364.704941228231, 4741.478437371887, 4754.976225118887, 4756.143894099061, 4769.332293478916, 4789.904201915977, 4941.01179764045, 5743.0, 5797.275340582427, 5801.274840644919, 5830.30036395631, 3418.1454636340914, 3756.7182461315238, 3777.622237776228, 3916.3146449371247, 3950.9604903951167, 5819.330776960662, 6035.818925432244, 6130.417610327012, 6155.815325540196, 6199.62802231863, 3335.5997280326515, 4010.2581022510344, 4019.718619696652, 4028.4964379452567, 4041.7979101045416, 3556.466530020466, 3913.5695073541888, 4091.1204091120553, 4095.1981128304046, 4104.261232978092, 4722.780293262162, 4728.503507131702, 4741.478437371887, 4758.643101767381, 4770.710059171617, 4793.41817200323, 5896.67081502804, 5900.822975310747, 5916.201312822714, 5934.0, 1178.3577950017261, 1278.3799857069314, 1302.4204229117952, 1368.1996032321006, 1383.764759990804, 902.7246689759686, 912.8630705394244, 930.134974473746, 935.4434111703525, 938.0994245524237, 5272.312859884877, 5513.862153446196, 5529.806456774074, 5530.253415788898, 5561.6663000220115, 5586.0, 5942.465178133989, 5956.404359564009, 5967.166595058017, 5969.582129250997, 4309.655227581786, 5422.48486393792, 5481.643693159932, 5591.993441180545, 5616.550675945915, 2561.3991255465335, 2653.3101393637407, 2669.8531580762856, 2671.786257099466, 2693.9595906061427, 4773.809047638125, 4987.020766773207, 5027.812901387908, 5307.708076055854, 5334.745805058911, 4691.460482044608, 5094.465081166424, 5117.309163262987, 5155.793768249228, 5185.0, 4583.358329833826, 4732.952670473252, 5239.5284424401225, 5254.377815737124, 5281.547574417066, 4224.4930608327195, 4685.882852928567, 4922.1541921779335, 5116.676408434867, 5125.359330083739, 5028.949710502849, 5329.680219186706, 6028.758849645965, 6031.914255434064, 6080.199875078076, 5393.97514472249, 6383.96808015957, 6405.423511883952, 6422.743090276336, 6428.55000149985, 3553.8578456861437, 3873.5351757789244, 3943.6845052395165, 4101.815418306123, 4112.696889741635, 4641.86074417768, 5762.971185144047, 6051.243594550681, 6101.0, 6125.693715314305, 4879.829205977774, 4937.037277730951, 5485.945140548543, 5666.603337766317, 5944.138099975566, 4809.759512024455, 5187.507186817246, 5365.490278423544, 5809.477147056785, 5906.759580488146, 4571.451425828789, 4740.952590474051, 5247.320857325619, 5500.4224556420995, 5596.048671725735, 4818.4217893852965, 5099.954509325654, 5202.323697919398, 5949.851253718692, 5981.940180598138, 4301.9354709678755, 4971.527704868032, 5526.613137080366, 5807.332156801853, 5845.444682755132], "value": 4089.7117788442943, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [709.8438343564417, 737.8856277277022, 781.7850091224913, 842.1662554071463, 846.9110743371943, 16221.756673649905, 16363.918180409097, 16482.093484858327, 17053.403130890438, 17086.060266685345, 15235.238238088079, 15396.461123860667, 15397.84602153978, 15418.537443876701, 15420.61448463789, 702.0136707925373, 722.122621015466, 865.3553102938304, 871.7123349294749, 888.7378223424106, 828.7928017995501, 854.6752234151014, 867.9218870301671, 894.6823877523483, 899.7795540092686, 909.4543274035592, 911.7538264668535, 913.4747520175926, 915.1854849184232, 918.5269586163131, 864.6843901975765, 867.6182479708908, 875.5097145598485, 896.7713233125577, 908.5548081440113, 648.3484098480997, 648.8864448721502, 650.4341223135855, 673.182083768224, 681.8602186551745, 15299.311530981022, 15343.923280383528, 15345.846541534553, 15356.846431535654, 15370.0, 12269.0, 15394.769078463833, 15460.995035322781, 15467.303971321206, 15558.222088895624, 11609.535618575246, 11802.409879506076, 12023.939880300542, 12242.81635775464, 12612.873871261261, 4867.902641947177, 4875.122477953967, 4913.14020046494, 4944.233643785219, 4951.108800415924, 114234.42882785533, 116891.99999999916, 117215.0, 117253.24120138204, 119035.21447178212, 11460.484278207501, 11800.996915262127, 11942.462589183508, 11980.640580782416, 12028.45871935765, 22343.66484502734, 22765.430864228525, 22777.658335124986, 22801.429964250696, 22856.0, 7859.919474549133, 8171.1828817119, 8175.182481751777, 8220.38347123968, 8360.122187170382, 3775.6413140751583, 4050.8784736457956, 4206.390073439334, 4403.735775853459, 4406.449193850769, 3514.3498452786316, 3643.763155394891, 3649.3431182387426, 3657.5428071491065, 3657.6708096271464, 659.9010148477671, 661.7981515637777, 680.2177495879778, 681.2506243132614, 691.4502970138651, 546.7703564502918, 575.9740811663485, 597.4055814464635, 606.8998615228526, 659.7361055577711, 7823.061232652118, 8768.649254029768, 8769.868451973225, 9127.497987610745, 9635.518224088768, 495.982640607577, 561.5732043646776, 638.288308535979, 642.2646070249538, 651.7816531461918, 4308.18144552534, 4522.23122069249, 4541.568550987717, 4556.389554372327, 4566.771661416916, 100693.4895976561, 146008.26995864953, 149025.25487372495, 160146.0, 161888.0, 95262.5236873825, 116057.8394216047, 131091.34454327667, 135384.0, 138798.0, 101183.97632047466, 109320.0, 116264.41867790607, 116808.41595791967, 121250.0, 8228.21831925966, 8412.87380689278, 9003.0, 9532.571034303335, 9950.751231219278, 40991.0, 57435.0, 61974.38025619686, 62177.0, 65356.34643653502, 75936.24063759291, 97113.0, 97264.0, 100276.0, 100812.49593751984, 10587.470626468492, 13521.932390337985, 13747.175169489863, 13893.305334733424, 14219.786703199667, 15178.24108794578, 15233.542993710207, 15678.0, 16032.358705651643, 16574.254158563133, 14412.711745765235, 14559.199244041256, 14842.851571484578, 14960.40158393652, 15465.226738662797, 13956.441742330193, 14039.649008774863, 14413.495527656481, 14846.925765371105, 14902.552923412315, 13975.161490310207, 14221.715565688835, 14461.13233206011, 14647.0, 14911.956163068915, 11402.828957565478, 11782.882171178178, 11913.0, 11947.701307467036, 12034.518619255132, 11434.313941163557, 11509.942450287695, 11872.168948173545, 12038.939805300917, 12060.758784824078], "value": 8005.670408671072, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1534.7000000000003, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 118.0, 120.0, 117.0, 118.0, 117.0, 117.0, 96.0, 174.0, 173.0], "value": 125.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 144.0, 96.0, 146.0, 93.0, 102.0, 117.0, 111.0, 175.0, 145.0], "value": 126.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [182.0, 202.0, 197.0, 205.0, 197.0, 193.0, 193.0, 197.0, 206.0, 198.0], "value": 197.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 59.0, 60.0, 91.0, 58.0, 59.0, 60.0, 64.0, 70.0, 64.0], "value": 66.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 69.0, 88.0, 77.0, 81.0, 99.0, 123.0, 60.0, 101.0, 98.0], "value": 88.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 133.0, 92.0, 89.0, 93.0, 132.0, 92.0, 90.0, 93.0, 101.0], "value": 101.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 96.0, 97.0, 97.0, 97.0, 96.0, 97.0, 105.0, 134.0, 97.0], "value": 102.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 92.0, 91.0, 90.0, 139.0, 86.0, 143.0, 141.0, 92.0, 96.0], "value": 106.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 56.0, 57.0, 77.0, 90.0, 58.0, 58.0, 58.0, 58.0, 59.0], "value": 62.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 72.0, 65.0, 82.0, 77.0, 104.0, 60.0, 80.0, 92.0, 102.0], "value": 79.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 84.0, 86.0, 83.0, 87.0, 85.0, 82.0, 80.0, 83.0, 90.0], "value": 84.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 139.0, 139.0, 139.0, 147.0, 144.0, 150.0, 168.0, 183.0, 174.0], "value": 151.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 156.0, 235.0, 205.0, 163.0, 165.0, 162.0, 166.0, 162.0, 169.0], "value": 174.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 65.0, 67.0, 68.0, 68.0, 67.0, 66.0, 68.0, 67.0, 66.0], "value": 67.0, "unit": "score"}]}]} 09:36:37 INFO - Return code: 0 09:36:37 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:36:37 ERROR - # TBPL SUCCESS # 09:36:37 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 09:36:37 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 09:36:37 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 09:36:37 INFO - 2016-12-20 09:36:37.603 screenresolution[1978:12841] starting screenresolution argv=screenresolution get 09:36:37 INFO - 2016-12-20 09:36:37.606 screenresolution[1978:12841] Display 0: 1600x1200x32@60 09:36:37 INFO - 2016-12-20 09:36:37.612 screenresolution[1979:12844] starting screenresolution argv=screenresolution list 09:36:37 INFO - Available Modes on Display 0 09:36:37 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 09:36:37 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 09:36:37 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 09:36:37 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 09:36:37 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 09:36:37 INFO - Intel Iris: 09:36:37 INFO - Chipset Model: Intel Iris 09:36:37 INFO - Type: GPU 09:36:37 INFO - Bus: Built-In 09:36:37 INFO - VRAM (Dynamic, Max): 1536 MB 09:36:37 INFO - Vendor: Intel (0x8086) 09:36:37 INFO - Device ID: 0x0a2e 09:36:37 INFO - Revision ID: 0x0009 09:36:37 INFO - Displays: 09:36:37 INFO - Display: 09:36:37 INFO - Resolution: 1600 x 1200 @ 60 Hz 09:36:37 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 09:36:37 INFO - Display Serial Number: 1600x1200 60 09:36:37 INFO - Main Display: Yes 09:36:37 INFO - Mirror: Off 09:36:37 INFO - Online: Yes 09:36:37 INFO - Rotation: Supported 09:36:37 INFO - Return code: 0 09:36:37 INFO - Running post-action listener: _resource_record_post_action 09:36:37 INFO - [mozharness: 2016-12-20 17:36:37.850974Z] Finished run-tests step (success) 09:36:37 INFO - Running post-run listener: _resource_record_post_run 09:36:37 INFO - Total resource usage - Wall time: 1195s; CPU: 54.0%; Read bytes: 1269760; Write bytes: 497046528; Read time: 14; Write time: 1584 09:36:37 INFO - TinderboxPrint: CPU usage
54.3% 09:36:37 INFO - TinderboxPrint: I/O read bytes / time
1,269,760 / 14 09:36:37 INFO - TinderboxPrint: I/O write bytes / time
497,046,528 / 1,584 09:36:37 INFO - TinderboxPrint: CPU idle
2,185.2 (45.7%) 09:36:37 INFO - TinderboxPrint: CPU system
971.3 (20.3%) 09:36:37 INFO - TinderboxPrint: CPU user
1,625.2 (34.0%) 09:36:37 INFO - TinderboxPrint: Swap in / out
196,329,472 / 0 09:36:37 INFO - install - Wall time: 23s; CPU: 55.0%; Read bytes: 187990528; Write bytes: 189220352; Read time: 17517; Write time: 398 09:36:37 INFO - run-tests - Wall time: 1173s; CPU: 54.0%; Read bytes: 425984; Write bytes: 296869376; Read time: 10; Write time: 1149 09:36:38 INFO - Running post-run listener: _upload_blobber_files 09:36:38 INFO - Blob upload gear active. 09:36:38 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:36:38 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 09:36:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:36:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:36:38 INFO - (blobuploader) - INFO - Open directory for files ... 09:36:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 09:36:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:36:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:36:39 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 09:36:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:36:39 INFO - (blobuploader) - INFO - Done attempting. 09:36:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 09:36:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:36:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:36:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 09:36:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:36:41 INFO - (blobuploader) - INFO - Done attempting. 09:36:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:36:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:36:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:36:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:36:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:36:44 INFO - (blobuploader) - INFO - Done attempting. 09:36:44 INFO - (blobuploader) - INFO - Iteration through files over. 09:36:44 INFO - Return code: 0 09:36:44 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:36:44 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:36:44 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f31fd87c5e563843c29259faaba531f709e74162aaafe388c35ef15a95b84508033d39f03dac3109e76c445e378c0f54159adb3adb73703ca740165fea5987f0", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/6175c9fd77bfe39e03bdc81349c1f9cf349fc5453de6a1b31ee4a1300293f7bc2e29878384487ce7fea334b1f17f4ebebcc6cb67bd1befe0e92b272b8dad060b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/bbce10d3c0ba2aad6f032477dc7674d30fa47744e822d5b7c8a22b3ffda3e6c33849acaccccbf07772165f053a15b7f447d7cbab018674865ba46996f175ee5a"} 09:36:44 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:36:44 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:36:44 INFO - Contents: 09:36:44 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f31fd87c5e563843c29259faaba531f709e74162aaafe388c35ef15a95b84508033d39f03dac3109e76c445e378c0f54159adb3adb73703ca740165fea5987f0", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/6175c9fd77bfe39e03bdc81349c1f9cf349fc5453de6a1b31ee4a1300293f7bc2e29878384487ce7fea334b1f17f4ebebcc6cb67bd1befe0e92b272b8dad060b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/bbce10d3c0ba2aad6f032477dc7674d30fa47744e822d5b7c8a22b3ffda3e6c33849acaccccbf07772165f053a15b7f447d7cbab018674865ba46996f175ee5a"} 09:36:44 INFO - Running post-run listener: copy_logs_to_upload_dir 09:36:44 INFO - Copying logs to upload dir... 09:36:44 INFO - mkdir: /builds/slave/test/build/upload/logs 09:36:44 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1257.512964 ========= master_lag: 1.71 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 20 mins, 59 secs) (at 2016-12-20 09:36:46.508321) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-20 09:36:46.516216) ========= 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.HTVKprZwJW/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.mVhh5NATt7/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f31fd87c5e563843c29259faaba531f709e74162aaafe388c35ef15a95b84508033d39f03dac3109e76c445e378c0f54159adb3adb73703ca740165fea5987f0", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/6175c9fd77bfe39e03bdc81349c1f9cf349fc5453de6a1b31ee4a1300293f7bc2e29878384487ce7fea334b1f17f4ebebcc6cb67bd1befe0e92b272b8dad060b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/bbce10d3c0ba2aad6f032477dc7674d30fa47744e822d5b7c8a22b3ffda3e6c33849acaccccbf07772165f053a15b7f447d7cbab018674865ba46996f175ee5a"} build_url:https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010644 build_url: 'https://queue.taskcluster.net/v1/task/ErEm5CvFS0GHkq1VdOWq0g/artifacts/public/build/firefox-51.0.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f31fd87c5e563843c29259faaba531f709e74162aaafe388c35ef15a95b84508033d39f03dac3109e76c445e378c0f54159adb3adb73703ca740165fea5987f0", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/6175c9fd77bfe39e03bdc81349c1f9cf349fc5453de6a1b31ee4a1300293f7bc2e29878384487ce7fea334b1f17f4ebebcc6cb67bd1befe0e92b272b8dad060b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/bbce10d3c0ba2aad6f032477dc7674d30fa47744e822d5b7c8a22b3ffda3e6c33849acaccccbf07772165f053a15b7f447d7cbab018674865ba46996f175ee5a"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-20 09:36:46.553727) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-20 09:36:46.557096) ========= 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.HTVKprZwJW/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.mVhh5NATt7/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/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.005267 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-20 09:36:46.605526) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-20 09:36:46.608868) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-20 09:36:46.609187) ========= ========= Total master_lag: 1.86 =========