builder: mozilla-aurora_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0241 starttime: 1474373519.03 results: success (0) buildid: 20160920024116 builduid: 70f2daedbcfc4625b1493831cd0d2313 revision: f16332940adb7f2b14de7379a1e8fe32a95a826a ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-20 05:11:59.028245) ========= master: http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-20 05:11:59.028697) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-20 05:11:59.028996) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-20 05:11:59.052724) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:11:59.053121) ========= 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.CRxGOy3xMT/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.TKW6dCTulb/Listeners TMPDIR=/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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-09-20 05:11:59-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 150M=0s 2016-09-20 05:11:59 (150 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.119175 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:11:59.194789) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:11:59.195144) ========= 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.CRxGOy3xMT/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.TKW6dCTulb/Listeners TMPDIR=/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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.020918 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:11:59.246737) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-20 05:11:59.247506) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev f16332940adb7f2b14de7379a1e8fe32a95a826a --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev f16332940adb7f2b14de7379a1e8fe32a95a826a --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.CRxGOy3xMT/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.TKW6dCTulb/Listeners TMPDIR=/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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-09-20 05:11:59,326 truncating revision to first 12 chars 2016-09-20 05:11:59,326 Setting DEBUG logging. 2016-09-20 05:11:59,326 attempt 1/10 2016-09-20 05:11:59,326 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/f16332940adb?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-20 05:12:00,945 unpacking tar archive at: mozilla-aurora-f16332940adb/testing/mozharness/ program finished with exit code 0 elapsedTime=1.872342 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-20 05:12:01.148709) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-20 05:12:01.149603) ========= script_repo_revision: f16332940adb7f2b14de7379a1e8fe32a95a826a ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-20 05:12:01.150787) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-20 05:12:01.151388) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-20 05:12:01.170921) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-09-20 05:12:01.171699) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.CRxGOy3xMT/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.TKW6dCTulb/Listeners TMPDIR=/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:01 INFO - MultiFileLogger online at 20160920 05:12:01 in /builds/slave/test 05:12:01 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 05:12:01 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:12:01 INFO - {'append_to_log': False, 05:12:01 INFO - 'base_work_dir': '/builds/slave/test', 05:12:01 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 05:12:01 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:12:01 INFO - 'branch': 'Mozilla-Aurora', 05:12:01 INFO - 'buildbot_json_path': 'buildprops.json', 05:12:01 INFO - 'config_files': ('talos/mac_config.py',), 05:12:01 INFO - 'default_actions': ('clobber', 05:12:01 INFO - 'read-buildbot-config', 05:12:01 INFO - 'download-and-extract', 05:12:01 INFO - 'populate-webroot', 05:12:01 INFO - 'create-virtualenv', 05:12:01 INFO - 'install', 05:12:01 INFO - 'run-tests'), 05:12:01 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:12:01 INFO - 'download_minidump_stackwalk': True, 05:12:01 INFO - 'download_symbols': 'ondemand', 05:12:01 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:12:01 INFO - 'tooltool.py': '/tools/tooltool.py', 05:12:01 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:12:01 INFO - '/tools/misc-python/virtualenv.py')}, 05:12:01 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:12:01 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:12:01 INFO - 'installer_path': 'installer.exe', 05:12:01 INFO - 'log_level': 'info', 05:12:01 INFO - 'log_name': 'talos', 05:12:01 INFO - 'log_to_console': True, 05:12:01 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 05:12:01 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 05:12:01 INFO - 'opt_config_files': (), 05:12:01 INFO - 'pip_index': False, 05:12:01 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:12:01 INFO - 'cmd': ('bash', 05:12:01 INFO - '-c', 05:12:01 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:12:01 INFO - 'enabled': True, 05:12:01 INFO - 'halt_on_failure': False, 05:12:01 INFO - 'name': 'check_screen_resolution'},), 05:12:01 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:12:01 INFO - 'cmd': ('bash', 05:12:01 INFO - '-c', 05:12:01 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:12:01 INFO - 'enabled': True, 05:12:01 INFO - 'halt_on_failure': False, 05:12:01 INFO - 'name': 'check_screen_resolution'},), 05:12:01 INFO - 'run_cmd_checks_enabled': True, 05:12:01 INFO - 'sps_profile': False, 05:12:01 INFO - 'sps_profile_interval': 0, 05:12:01 INFO - 'suite': 'dromaeojs-e10s', 05:12:01 INFO - 'system_bits': '32', 05:12:01 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:12:01 INFO - 'title': 't-yosemite-r7-0241', 05:12:01 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:12:01 INFO - 'use_talos_json': True, 05:12:01 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:12:01 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:12:01 INFO - 'work_dir': 'build'} 05:12:01 INFO - [mozharness: 2016-09-20 12:12:01.364677Z] Running clobber step. 05:12:01 INFO - Running pre-action listener: _resource_record_pre_action 05:12:01 INFO - Running main action method: clobber 05:12:01 INFO - rmtree: /builds/slave/test/build 05:12:01 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:12:02 INFO - Running post-action listener: _resource_record_post_action 05:12:02 INFO - [mozharness: 2016-09-20 12:12:02.842530Z] Finished clobber step (success) 05:12:02 INFO - [mozharness: 2016-09-20 12:12:02.842650Z] Running read-buildbot-config step. 05:12:02 INFO - Running pre-action listener: _resource_record_pre_action 05:12:02 INFO - Running main action method: read_buildbot_config 05:12:02 INFO - Using buildbot properties: 05:12:02 INFO - { 05:12:02 INFO - "project": "", 05:12:02 INFO - "product": "firefox", 05:12:02 INFO - "script_repo_revision": "production", 05:12:02 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs-e10s", 05:12:02 INFO - "repository": "", 05:12:02 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs-e10s", 05:12:02 INFO - "buildid": "20160920024116", 05:12:02 INFO - "pgo_build": "False", 05:12:02 INFO - "basedir": "/builds/slave/test", 05:12:02 INFO - "buildnumber": 96, 05:12:02 INFO - "slavename": "t-yosemite-r7-0241", 05:12:02 INFO - "master": "http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/", 05:12:02 INFO - "platform": "yosemite_r7", 05:12:02 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 05:12:02 INFO - "branch": "mozilla-aurora", 05:12:02 INFO - "repo_path": "releases/mozilla-aurora", 05:12:02 INFO - "revision": "f16332940adb7f2b14de7379a1e8fe32a95a826a", 05:12:02 INFO - "stage_platform": "macosx64", 05:12:02 INFO - "builduid": "70f2daedbcfc4625b1493831cd0d2313", 05:12:02 INFO - "slavebuilddir": "test" 05:12:02 INFO - } 05:12:02 INFO - Found installer url https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg. 05:12:02 INFO - Running post-action listener: _resource_record_post_action 05:12:02 INFO - [mozharness: 2016-09-20 12:12:02.846014Z] Finished read-buildbot-config step (success) 05:12:02 INFO - [mozharness: 2016-09-20 12:12:02.846155Z] Running download-and-extract step. 05:12:02 INFO - Running pre-action listener: _resource_record_pre_action 05:12:02 INFO - Running main action method: download_and_extract 05:12:02 INFO - mkdir: /builds/slave/test/build/tests 05:12:02 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')]} 05:12:02 INFO - trying https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json 05:12:02 INFO - Downloading https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 05:12:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json'}, attempt #1 05:12:03 INFO - Downloaded 1199 bytes. 05:12:03 INFO - Reading from file /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 05:12:03 INFO - Using the following test package requirements: 05:12:03 INFO - {u'common': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 05:12:03 INFO - u'cppunittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:12:03 INFO - u'firefox-51.0a2.en-US.mac.cppunittest.tests.zip'], 05:12:03 INFO - u'gtest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:12:03 INFO - u'firefox-51.0a2.en-US.mac.gtest.tests.zip'], 05:12:03 INFO - u'jittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:12:03 INFO - u'jsshell-mac.zip'], 05:12:03 INFO - u'mochitest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:12:03 INFO - u'firefox-51.0a2.en-US.mac.mochitest.tests.zip'], 05:12:03 INFO - u'mozbase': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 05:12:03 INFO - u'reftest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:12:03 INFO - u'firefox-51.0a2.en-US.mac.reftest.tests.zip'], 05:12:03 INFO - u'talos': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:12:03 INFO - u'firefox-51.0a2.en-US.mac.talos.tests.zip'], 05:12:03 INFO - u'web-platform': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:12:03 INFO - u'firefox-51.0a2.en-US.mac.web-platform.tests.zip'], 05:12:03 INFO - u'xpcshell': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:12:03 INFO - u'firefox-51.0a2.en-US.mac.xpcshell.tests.zip']} 05:12:03 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip'] for test suite category: common 05:12:03 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 05:12:03 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 05:12:03 INFO - Fetch https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 05:12:04 INFO - Expected file size: 16426178 05:12:11 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip', u'firefox-51.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 05:12:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 05:12:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 05:12:11 INFO - Fetch https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 05:12:12 INFO - Expected file size: 16426178 05:12:19 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip 05:12:19 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip'}, attempt #1 05:12:19 INFO - Fetch https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip into memory 05:12:20 INFO - Expected file size: 14414059 05:12:20 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')]} 05:12:20 INFO - trying https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 05:12:20 INFO - Downloading https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg 05:12:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg'}, attempt #1 05:12:23 INFO - Downloaded 115238379 bytes. 05:12:23 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 05:12:23 INFO - mkdir: /builds/slave/test/properties 05:12:23 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:12:23 INFO - Writing to file /builds/slave/test/properties/build_url 05:12:23 INFO - Contents: 05:12:23 INFO - build_url:https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 05:12:24 INFO - Running post-action listener: _resource_record_post_action 05:12:24 INFO - Running post-action listener: set_extra_try_arguments 05:12:24 INFO - [mozharness: 2016-09-20 12:12:24.403145Z] Finished download-and-extract step (success) 05:12:24 INFO - [mozharness: 2016-09-20 12:12:24.403305Z] Running populate-webroot step. 05:12:24 INFO - Running pre-action listener: _resource_record_pre_action 05:12:24 INFO - Running main action method: populate_webroot 05:12:24 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:12:24 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:12:24 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:12:24 INFO - '--tppagecycles', 05:12:24 INFO - '7'], 05:12:24 INFO - 'tests': ['tsvgm']}}, 05:12:24 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:12:24 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:12:24 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:12:24 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:12:24 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:12:24 INFO - 'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:12:24 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:12:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:12:24 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:12:24 INFO - 'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['damp', 'tps']}, 05:12:24 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:12:24 INFO - 'tests': ['damp', 'tps']}, 05:12:24 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['dromaeo_dom']}, 05:12:24 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:12:24 INFO - 'g4': {'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['basic_compositor_video']}, 05:12:24 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 05:12:24 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['a11yr', 05:12:24 INFO - 'ts_paint', 05:12:24 INFO - 'tpaint', 05:12:24 INFO - 'sessionrestore', 05:12:24 INFO - 'sessionrestore_no_auto_restore', 05:12:24 INFO - 'tabpaint']}, 05:12:24 INFO - 'other-e10s': {'tests': ['a11yr', 05:12:24 INFO - 'ts_paint', 05:12:24 INFO - 'tpaint', 05:12:24 INFO - 'sessionrestore', 05:12:24 INFO - 'sessionrestore_no_auto_restore', 05:12:24 INFO - 'tabpaint']}, 05:12:24 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:12:24 INFO - 'ts_paint', 05:12:24 INFO - 'tpaint', 05:12:24 INFO - 'sessionrestore', 05:12:24 INFO - 'sessionrestore_no_auto_restore', 05:12:24 INFO - 'tabpaint']}, 05:12:24 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:12:24 INFO - 'ts_paint', 05:12:24 INFO - 'tpaint', 05:12:24 INFO - 'sessionrestore', 05:12:24 INFO - 'sessionrestore_no_auto_restore', 05:12:24 INFO - 'tabpaint']}, 05:12:24 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['a11yr', 05:12:24 INFO - 'ts_paint', 05:12:24 INFO - 'tpaint', 05:12:24 INFO - 'sessionrestore', 05:12:24 INFO - 'sessionrestore_no_auto_restore', 05:12:24 INFO - 'tabpaint']}, 05:12:24 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['a11yr', 05:12:24 INFO - 'ts_paint', 05:12:24 INFO - 'tpaint', 05:12:24 INFO - 'sessionrestore', 05:12:24 INFO - 'sessionrestore_no_auto_restore', 05:12:24 INFO - 'tabpaint']}, 05:12:24 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['tsvgx', 05:12:24 INFO - 'tsvgr_opacity', 05:12:24 INFO - 'tart', 05:12:24 INFO - 'tscrollx', 05:12:24 INFO - 'cart']}, 05:12:24 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:12:24 INFO - 'tsvgr_opacity', 05:12:24 INFO - 'tart', 05:12:24 INFO - 'tscrollx', 05:12:24 INFO - 'cart']}, 05:12:24 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:12:24 INFO - 'talos_options': ['--disable-e10s'], 05:12:24 INFO - 'tests': ['tp5o']}, 05:12:24 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:12:24 INFO - 'tests': ['tp5o']}, 05:12:24 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:12:24 INFO - 'talos_options': ['--disable-e10s', 05:12:24 INFO - '--xperf_path', 05:12:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:12:24 INFO - 'tests': ['tp5n']}, 05:12:24 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:12:24 INFO - 'talos_options': ['--xperf_path', 05:12:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:12:24 INFO - 'tests': ['tp5n']}}, 05:12:24 INFO - 'talos.zip': {'path': '', 05:12:24 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:12:24 INFO - Running post-action listener: _resource_record_post_action 05:12:24 INFO - [mozharness: 2016-09-20 12:12:24.421580Z] Finished populate-webroot step (success) 05:12:24 INFO - [mozharness: 2016-09-20 12:12:24.421688Z] Running create-virtualenv step. 05:12:24 INFO - Running pre-action listener: _resource_record_pre_action 05:12:24 INFO - Running main action method: create_virtualenv 05:12:24 INFO - Creating virtualenv /builds/slave/test/build/venv 05:12:24 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 05:12:24 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:12:24 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:12:24 INFO - Using real prefix '/tools/python27' 05:12:24 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:12:25 INFO - Installing distribute.............................................................................................................................................................................................done. 05:12:28 INFO - Installing pip.................done. 05:12:28 INFO - Return code: 0 05:12:28 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:28 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:28 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 05:12:28 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 05:12:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:28 INFO - 'HOME': '/Users/cltbld', 05:12:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:28 INFO - 'LOGNAME': 'cltbld', 05:12:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:28 INFO - 'MOZ_NO_REMOTE': '1', 05:12:28 INFO - 'NO_EM_RESTART': '1', 05:12:28 INFO - 'PAGER': '/bin/cat', 05:12:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:28 INFO - 'PWD': '/builds/slave/test', 05:12:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:28 INFO - 'SHELL': '/bin/bash', 05:12:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:28 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:28 INFO - 'USER': 'cltbld', 05:12:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:28 INFO - 'XPC_FLAGS': '0x0', 05:12:28 INFO - 'XPC_SERVICE_NAME': '0', 05:12:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:28 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 05:12:28 INFO - Cleaning up... 05:12:28 INFO - Return code: 0 05:12:28 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:28 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:28 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 05:12:28 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 05:12:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:28 INFO - 'HOME': '/Users/cltbld', 05:12:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:28 INFO - 'LOGNAME': 'cltbld', 05:12:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:28 INFO - 'MOZ_NO_REMOTE': '1', 05:12:28 INFO - 'NO_EM_RESTART': '1', 05:12:28 INFO - 'PAGER': '/bin/cat', 05:12:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:28 INFO - 'PWD': '/builds/slave/test', 05:12:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:28 INFO - 'SHELL': '/bin/bash', 05:12:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:28 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:28 INFO - 'USER': 'cltbld', 05:12:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:28 INFO - 'XPC_FLAGS': '0x0', 05:12:28 INFO - 'XPC_SERVICE_NAME': '0', 05:12:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:28 INFO - Downloading/unpacking psutil>=3.1.1 05:12:28 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 05:12:28 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 05:12:28 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 05:12:28 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 05:12:28 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 05:12:28 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 05:12:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:12:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:12:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:12:32 INFO - Installing collected packages: psutil 05:12:32 INFO - Running setup.py install for psutil 05:12:32 INFO - building 'psutil._psutil_osx' extension 05:12:32 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 05:12:32 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 05:12:32 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 05:12:32 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 05:12:32 INFO - building 'psutil._psutil_posix' extension 05:12:32 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 05:12:32 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 05:12:32 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 05:12:32 INFO - ^ 05:12:32 INFO - 1 warning generated. 05:12:32 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 05:12:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:12:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:12:32 INFO - Successfully installed psutil 05:12:32 INFO - Cleaning up... 05:12:33 INFO - Return code: 0 05:12:33 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:12:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:33 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:33 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 05:12:33 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 05:12:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:33 INFO - 'HOME': '/Users/cltbld', 05:12:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:33 INFO - 'LOGNAME': 'cltbld', 05:12:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:33 INFO - 'MOZ_NO_REMOTE': '1', 05:12:33 INFO - 'NO_EM_RESTART': '1', 05:12:33 INFO - 'PAGER': '/bin/cat', 05:12:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:33 INFO - 'PWD': '/builds/slave/test', 05:12:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:33 INFO - 'SHELL': '/bin/bash', 05:12:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:33 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:33 INFO - 'USER': 'cltbld', 05:12:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:33 INFO - 'XPC_FLAGS': '0x0', 05:12:33 INFO - 'XPC_SERVICE_NAME': '0', 05:12:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:33 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:12:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:12:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:12:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:35 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:12:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:12:35 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:12:35 INFO - Installing collected packages: mozsystemmonitor 05:12:35 INFO - Running setup.py install for mozsystemmonitor 05:12:36 INFO - Successfully installed mozsystemmonitor 05:12:36 INFO - Cleaning up... 05:12:36 INFO - Return code: 0 05:12:36 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:12: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')]} 05:12:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12: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')]} 05:12:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:36 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:36 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 05:12:36 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 05:12:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:36 INFO - 'HOME': '/Users/cltbld', 05:12:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:36 INFO - 'LOGNAME': 'cltbld', 05:12:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:36 INFO - 'MOZ_NO_REMOTE': '1', 05:12:36 INFO - 'NO_EM_RESTART': '1', 05:12:36 INFO - 'PAGER': '/bin/cat', 05:12:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:36 INFO - 'PWD': '/builds/slave/test', 05:12:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:36 INFO - 'SHELL': '/bin/bash', 05:12:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:36 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:36 INFO - 'USER': 'cltbld', 05:12:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:36 INFO - 'XPC_FLAGS': '0x0', 05:12:36 INFO - 'XPC_SERVICE_NAME': '0', 05:12:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:36 INFO - Downloading/unpacking jsonschema==2.5.1 05:12:36 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 05:12:36 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 05:12:36 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 05:12:36 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 05:12:36 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 05:12:36 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 05:12:38 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:12:38 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:12: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 05:12: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 05:12: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 05:12: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 05:12: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 05:12: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 05:12:39 INFO - Downloading functools32-3.2.3-2.tar.gz 05:12:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:12:39 INFO - warning: no files found matching '*.txt' 05:12:39 INFO - no previously-included directories found matching 'build' 05:12:39 INFO - no previously-included directories found matching 'dist' 05:12:39 INFO - no previously-included directories found matching '.git*' 05:12:39 INFO - Installing collected packages: jsonschema, functools32 05:12:39 INFO - Running setup.py install for functools32 05:12:39 INFO - warning: no files found matching '*.txt' 05:12:39 INFO - no previously-included directories found matching 'build' 05:12:39 INFO - no previously-included directories found matching 'dist' 05:12:39 INFO - no previously-included directories found matching '.git*' 05:12:39 INFO - Successfully installed jsonschema functools32 05:12:39 INFO - Cleaning up... 05:12:39 INFO - Return code: 0 05:12:39 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 05:12:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:39 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:39 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 05:12:39 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 05:12:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:39 INFO - 'HOME': '/Users/cltbld', 05:12:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:39 INFO - 'LOGNAME': 'cltbld', 05:12:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:39 INFO - 'MOZ_NO_REMOTE': '1', 05:12:39 INFO - 'NO_EM_RESTART': '1', 05:12:39 INFO - 'PAGER': '/bin/cat', 05:12:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:39 INFO - 'PWD': '/builds/slave/test', 05:12:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:39 INFO - 'SHELL': '/bin/bash', 05:12:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:39 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:39 INFO - 'USER': 'cltbld', 05:12:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:39 INFO - 'XPC_FLAGS': '0x0', 05:12:39 INFO - 'XPC_SERVICE_NAME': '0', 05:12:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:39 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 05:12:39 INFO - Cleaning up... 05:12:39 INFO - Return code: 0 05:12:39 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:12:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:39 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:39 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 05:12:39 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 05:12:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:39 INFO - 'HOME': '/Users/cltbld', 05:12:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:39 INFO - 'LOGNAME': 'cltbld', 05:12:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:39 INFO - 'MOZ_NO_REMOTE': '1', 05:12:39 INFO - 'NO_EM_RESTART': '1', 05:12:39 INFO - 'PAGER': '/bin/cat', 05:12:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:39 INFO - 'PWD': '/builds/slave/test', 05:12:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:39 INFO - 'SHELL': '/bin/bash', 05:12:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:39 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:39 INFO - 'USER': 'cltbld', 05:12:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:39 INFO - 'XPC_FLAGS': '0x0', 05:12:39 INFO - 'XPC_SERVICE_NAME': '0', 05:12:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:40 INFO - Downloading/unpacking blobuploader==1.2.4 05:12:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:12:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:12:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:42 INFO - Downloading blobuploader-1.2.4.tar.gz 05:12:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:12:42 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:12:42 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 05:12:42 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 05:12:42 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 05:12:42 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 05:12:42 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 05:12:42 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 05:12:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:12:43 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:12:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:43 INFO - Downloading docopt-0.6.1.tar.gz 05:12:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:12:43 INFO - Installing collected packages: blobuploader, requests, docopt 05:12:43 INFO - Running setup.py install for blobuploader 05:12:43 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:12:43 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:12:43 INFO - Running setup.py install for requests 05:12:44 INFO - Running setup.py install for docopt 05:12:44 INFO - Successfully installed blobuploader requests docopt 05:12:44 INFO - Cleaning up... 05:12:44 INFO - Return code: 0 05:12:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:12:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:44 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:44 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 05:12:44 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 05:12:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:44 INFO - 'HOME': '/Users/cltbld', 05:12:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:44 INFO - 'LOGNAME': 'cltbld', 05:12:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:44 INFO - 'MOZ_NO_REMOTE': '1', 05:12:44 INFO - 'NO_EM_RESTART': '1', 05:12:44 INFO - 'PAGER': '/bin/cat', 05:12:44 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:44 INFO - 'PWD': '/builds/slave/test', 05:12:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:44 INFO - 'SHELL': '/bin/bash', 05:12:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:44 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:44 INFO - 'USER': 'cltbld', 05:12:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:44 INFO - 'XPC_FLAGS': '0x0', 05:12:44 INFO - 'XPC_SERVICE_NAME': '0', 05:12:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:12:44 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-Sjuq8C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-qsJzHj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-UoHO0O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-pdPbKj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-Kb1yuZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-6DobCm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-F5S6NC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-zP79WH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-22q4Sl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-oC2qXl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:12:45 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-QU2P77-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:12:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:12:46 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-9lmd8E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:12:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:12:46 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-As3ZR5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:12:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:12:46 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-YEixG5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:12:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:12:46 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-UdD_4C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:12:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:12:46 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-fIQW9Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:12:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:12:46 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-4lu0Z4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:12:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:12:46 INFO - Running setup.py install for manifestparser 05:12:46 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:12:46 INFO - Running setup.py install for mozcrash 05:12:46 INFO - Running setup.py install for mozdebug 05:12:47 INFO - Running setup.py install for mozdevice 05:12:47 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:12:47 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:12:47 INFO - Running setup.py install for mozfile 05:12:47 INFO - Running setup.py install for mozhttpd 05:12:47 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:12:47 INFO - Running setup.py install for mozinfo 05:12:47 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:12:47 INFO - Running setup.py install for mozInstall 05:12:47 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:12:47 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:12:47 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:12:47 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:12:47 INFO - Running setup.py install for mozleak 05:12:47 INFO - Running setup.py install for mozlog 05:12:48 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:12:48 INFO - Running setup.py install for moznetwork 05:12:48 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:12:48 INFO - Running setup.py install for mozprocess 05:12:48 INFO - Running setup.py install for mozprofile 05:12:48 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:12:48 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:12:48 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:12:48 INFO - Running setup.py install for mozrunner 05:12:48 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:12:48 INFO - Running setup.py install for mozscreenshot 05:12:48 INFO - Running setup.py install for moztest 05:12:49 INFO - Running setup.py install for mozversion 05:12:49 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:12:49 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:12:49 INFO - Cleaning up... 05:12:49 INFO - Return code: 0 05:12:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:12: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')]} 05:12:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12: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')]} 05:12:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:49 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:49 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 05:12:49 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 05:12:49 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:49 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:49 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:49 INFO - 'HOME': '/Users/cltbld', 05:12:49 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:49 INFO - 'LOGNAME': 'cltbld', 05:12:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:49 INFO - 'MOZ_NO_REMOTE': '1', 05:12:49 INFO - 'NO_EM_RESTART': '1', 05:12:49 INFO - 'PAGER': '/bin/cat', 05:12:49 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:49 INFO - 'PWD': '/builds/slave/test', 05:12:49 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:49 INFO - 'SHELL': '/bin/bash', 05:12:49 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:49 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:49 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:49 INFO - 'USER': 'cltbld', 05:12:49 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:49 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:49 INFO - 'XPC_FLAGS': '0x0', 05:12:49 INFO - 'XPC_SERVICE_NAME': '0', 05:12:49 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:12:49 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-TDF_uM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:12:49 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)) 05:12:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:12:49 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-PKgQAL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:12:49 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)) 05:12:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:12:49 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-rsB5nm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:12:49 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)) 05:12:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:12:49 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-Vq3uKB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:12:49 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)) 05:12:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:12:49 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-1kQDHp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-sA569i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-tqlglX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-pzHARF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-jIoeLY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-iHp9IZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-xh3JsM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-icEIsB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-mmHjki-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:12:50 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)) 05:12:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:12:50 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-EbWmbW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:12:51 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)) 05:12:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:12:51 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-hTGnYd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:12:51 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)) 05:12:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:12:51 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-pyhZat-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:12:51 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)) 05:12:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:12:51 INFO - Running setup.py (path:/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/pip-DXy7TY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:12:51 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)) 05:12:51 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)) 05:12:51 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)) 05:12:51 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)) 05:12:51 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)) 05:12:51 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)) 05:12:51 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:12:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:12:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:12:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:53 INFO - Downloading blessings-1.6.tar.gz 05:12:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:12:53 INFO - Installing collected packages: blessings 05:12:53 INFO - Running setup.py install for blessings 05:12:54 INFO - Successfully installed blessings 05:12:54 INFO - Cleaning up... 05:12:54 INFO - Return code: 0 05:12:54 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:12:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:12:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:12:54 INFO - Reading from file tmpfile_stdout 05:12:54 INFO - Current package versions: 05:12:54 INFO - blessings == 1.6 05:12:54 INFO - blobuploader == 1.2.4 05:12:54 INFO - docopt == 0.6.1 05:12:54 INFO - functools32 == 3.2.3-2 05:12:54 INFO - jsonschema == 2.5.1 05:12:54 INFO - manifestparser == 1.1 05:12:54 INFO - mozInstall == 1.12 05:12:54 INFO - mozcrash == 0.17 05:12:54 INFO - mozdebug == 0.1 05:12:54 INFO - mozdevice == 0.48 05:12:54 INFO - mozfile == 1.2 05:12:54 INFO - mozhttpd == 0.7 05:12:54 INFO - mozinfo == 0.9 05:12:54 INFO - mozleak == 0.1 05:12:54 INFO - mozlog == 3.4 05:12:54 INFO - moznetwork == 0.27 05:12:54 INFO - mozprocess == 0.23 05:12:54 INFO - mozprofile == 0.28 05:12:54 INFO - mozrunner == 6.12 05:12:54 INFO - mozscreenshot == 0.1 05:12:54 INFO - mozsystemmonitor == 0.3 05:12:54 INFO - moztest == 0.7 05:12:54 INFO - mozversion == 1.4 05:12:54 INFO - psutil == 3.1.1 05:12:54 INFO - requests == 1.2.3 05:12:54 INFO - wsgiref == 0.1.2 05:12:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:12:54 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')]} 05:12:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:54 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')]} 05:12:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:54 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:54 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 05:12:54 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 05:12:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:54 INFO - 'HOME': '/Users/cltbld', 05:12:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:54 INFO - 'LOGNAME': 'cltbld', 05:12:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:54 INFO - 'MOZ_NO_REMOTE': '1', 05:12:54 INFO - 'NO_EM_RESTART': '1', 05:12:54 INFO - 'PAGER': '/bin/cat', 05:12:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:54 INFO - 'PWD': '/builds/slave/test', 05:12:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:54 INFO - 'SHELL': '/bin/bash', 05:12:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:54 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:54 INFO - 'USER': 'cltbld', 05:12:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:54 INFO - 'XPC_FLAGS': '0x0', 05:12:54 INFO - 'XPC_SERVICE_NAME': '0', 05:12:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 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)) 05:12:54 INFO - Cleaning up... 05:12:54 INFO - Return code: 0 05:12:54 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:12:54 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')]} 05:12:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:54 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')]} 05:12:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:12:54 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 0x10fa36490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f9ac570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9670472670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, '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.CRxGOy3xMT/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.TKW6dCTulb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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 05:12:54 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 05:12:54 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 05:12:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:12:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:12:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:12:54 INFO - 'HOME': '/Users/cltbld', 05:12:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:12:54 INFO - 'LOGNAME': 'cltbld', 05:12:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:54 INFO - 'MOZ_NO_REMOTE': '1', 05:12:54 INFO - 'NO_EM_RESTART': '1', 05:12:54 INFO - 'PAGER': '/bin/cat', 05:12:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:12:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:54 INFO - 'PWD': '/builds/slave/test', 05:12:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:12:54 INFO - 'SHELL': '/bin/bash', 05:12:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:12:54 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:12:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:12:54 INFO - 'USER': 'cltbld', 05:12:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:12:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:12:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:54 INFO - 'XPC_FLAGS': '0x0', 05:12:54 INFO - 'XPC_SERVICE_NAME': '0', 05:12:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:12:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:54 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:12:54 INFO - Cleaning up... 05:12:54 INFO - Return code: 0 05:12:54 INFO - Running post-action listener: _resource_record_post_action 05:12:54 INFO - Running post-action listener: _start_resource_monitoring 05:12:55 INFO - Starting resource monitoring. 05:12:55 INFO - [mozharness: 2016-09-20 12:12:55.011101Z] Finished create-virtualenv step (success) 05:12:55 INFO - [mozharness: 2016-09-20 12:12:55.012093Z] Running install step. 05:12:55 INFO - Running pre-action listener: _resource_record_pre_action 05:12:55 INFO - Running main action method: install 05:12:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:12:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:12:55 INFO - Reading from file tmpfile_stdout 05:12:55 INFO - Detecting whether we're running mozinstall >=1.0... 05:12:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:12:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:12:55 INFO - Reading from file tmpfile_stdout 05:12:55 INFO - Output received: 05:12:55 INFO - Usage: mozinstall [options] installer 05:12:55 INFO - Options: 05:12:55 INFO - -h, --help show this help message and exit 05:12:55 INFO - -d DEST, --destination=DEST 05:12:55 INFO - Directory to install application into. [default: 05:12:55 INFO - "/builds/slave/test"] 05:12:55 INFO - --app=APP Application being installed. [default: firefox] 05:12:55 INFO - mkdir: /builds/slave/test/build/application 05:12:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 05:12:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 05:13:27 INFO - Reading from file tmpfile_stdout 05:13:27 INFO - Output received: 05:13:27 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 05:13:27 INFO - Running post-action listener: _resource_record_post_action 05:13:27 INFO - [mozharness: 2016-09-20 12:13:27.923193Z] Finished install step (success) 05:13:27 INFO - [mozharness: 2016-09-20 12:13:27.923348Z] Running run-tests step. 05:13:27 INFO - Running pre-action listener: _resource_record_pre_action 05:13:27 INFO - Running main action method: run_tests 05:13:27 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:13:27 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:13:27 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:13:27 INFO - 2016-09-20 05:13:27.937 screenresolution[1933:17033] starting screenresolution argv=screenresolution get 05:13:27 INFO - 2016-09-20 05:13:27.940 screenresolution[1933:17033] Display 0: 1600x1200x32@60 05:13:27 INFO - 2016-09-20 05:13:27.946 screenresolution[1934:17035] starting screenresolution argv=screenresolution list 05:13:27 INFO - Available Modes on Display 0 05:13:27 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:13:27 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:13:27 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:13:27 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:13:28 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:13:28 INFO - Intel Iris: 05:13:28 INFO - Chipset Model: Intel Iris 05:13:28 INFO - Type: GPU 05:13:28 INFO - Bus: Built-In 05:13:28 INFO - VRAM (Dynamic, Max): 1536 MB 05:13:28 INFO - Vendor: Intel (0x8086) 05:13:28 INFO - Device ID: 0x0a2e 05:13:28 INFO - Revision ID: 0x0009 05:13:28 INFO - Displays: 05:13:28 INFO - Display: 05:13:28 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:13:28 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:13:28 INFO - Display Serial Number: 1600x1200 60 05:13:28 INFO - Main Display: Yes 05:13:28 INFO - Mirror: Off 05:13:28 INFO - Online: Yes 05:13:28 INFO - Rotation: Supported 05:13:28 INFO - Return code: 0 05:13:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:13:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:13:28 INFO - Python 2.7.3 05:13:28 INFO - Return code: 0 05:13:28 INFO - grabbing minidump binary from tooltool 05:13:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:13:28 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 0x10f84ad30>, '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 0x10f6b0db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f842b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:13:28 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 05:13:28 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 05:13:28 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 05:13:28 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:13:28 INFO - Return code: 0 05:13:28 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 05:13:28 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:13:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:13:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 05:13:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:13:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0241', '--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 05:13:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0241 --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 05:13:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.CRxGOy3xMT/Render', 05:13:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:13:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:13:28 INFO - 'HOME': '/Users/cltbld', 05:13:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:13:28 INFO - 'LOGNAME': 'cltbld', 05:13:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:13:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 05:13:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:13:28 INFO - 'MOZ_NO_REMOTE': '1', 05:13:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:13:28 INFO - 'NO_EM_RESTART': '1', 05:13:28 INFO - 'PAGER': '/bin/cat', 05:13:28 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:13:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:13:28 INFO - 'PWD': '/builds/slave/test', 05:13:28 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:13:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:13:28 INFO - 'SHELL': '/bin/bash', 05:13:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TKW6dCTulb/Listeners', 05:13:28 INFO - 'TMPDIR': '/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/', 05:13:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:13:28 INFO - 'USER': 'cltbld', 05:13:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:13:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:13:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:13:28 INFO - 'XPC_FLAGS': '0x0', 05:13:28 INFO - 'XPC_SERVICE_NAME': '0', 05:13:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:13:28 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0241', '--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 05:13:28 INFO - mozversion application_buildid: 20160920024116 05:13:28 INFO - mozversion application_changeset: f16332940adb7f2b14de7379a1e8fe32a95a826a 05:13:28 INFO - mozversion application_display_name: FirefoxDeveloperEdition 05:13:28 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:13:28 INFO - mozversion application_name: Firefox 05:13:28 INFO - mozversion application_remotingname: firefox-dev 05:13:28 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 05:13:28 INFO - mozversion application_vendor: Mozilla 05:13:28 INFO - mozversion application_version: 51.0a2 05:13:28 INFO - mozversion platform_buildid: 20160920024116 05:13:28 INFO - mozversion platform_changeset: f16332940adb7f2b14de7379a1e8fe32a95a826a 05:13:28 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 05:13:28 INFO - mozversion platform_version: 51.0a2 05:13:28 INFO - using testdate: 1474373608 05:13:28 INFO - actual date: 1474373608 05:13:28 INFO - starting webserver on 'localhost:52736' 05:13:28 INFO - SUITE-START | Running 2 tests 05:13:28 INFO - TEST-START | dromaeo_css 05:13:28 INFO - operating with platform_type : mac_ 05:13:28 INFO - Initialising browser for dromaeo_css test... 05:13:28 INFO - TEST-INFO | started process 1944 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/tmpGRp4xY/profile http://localhost:52736/getInfo.html) 05:13:31 INFO - PROCESS | 1944 | __metrics Screen width/height:1600/1200 05:13:31 INFO - PROCESS | 1944 | colorDepth:24 05:13:31 INFO - PROCESS | 1944 | Browser inner width/height: 1024/689 05:13:31 INFO - PROCESS | 1944 | __metrics 05:13:31 ERROR - PROCESS | 1944 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 05:13:32 INFO - TEST-INFO | 1944: exit 0 05:13:32 INFO - Browser initialized. 05:13:32 INFO - Running cycle 1/1 for dromaeo_css test... 05:13:32 INFO - TEST-INFO | started process 1947 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/tmpGRp4xY/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:13:44 INFO - PROCESS | 1947 | RSS: Main: 224980992 05:13:44 INFO - PROCESS | 1947 | 05:14:33 INFO - PROCESS | 1947 | 1474373673734 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] 05:16:46 INFO - PROCESS | 1947 | Cycle 1(1): loaded http://localhost:52736/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52736/tests/dromaeo/cssquery-ext.html) 05:16:47 INFO - PROCESS | 1947 | RSS: Main: 236367872 05:16:47 INFO - PROCESS | 1947 | 05:19:50 INFO - PROCESS | 1947 | Cycle 1(1): loaded http://localhost:52736/tests/dromaeo/cssquery-ext.html (next: http://localhost:52736/tests/dromaeo/cssquery-jquery.html) 05:19:50 INFO - PROCESS | 1947 | RSS: Main: 245936128 05:19:50 INFO - PROCESS | 1947 | 05:22:52 INFO - PROCESS | 1947 | Cycle 1(1): loaded http://localhost:52736/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52736/tests/dromaeo/cssquery-mootools.html) 05:22:53 INFO - PROCESS | 1947 | RSS: Main: 251092992 05:22:53 INFO - PROCESS | 1947 | 05:25:55 INFO - PROCESS | 1947 | Cycle 1(1): loaded http://localhost:52736/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52736/tests/dromaeo/cssquery-prototype.html) 05:25:55 INFO - PROCESS | 1947 | RSS: Main: 251158528 05:25:55 INFO - PROCESS | 1947 | 05:28:58 INFO - PROCESS | 1947 | Cycle 1(1): loaded http://localhost:52736/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52736/tests/dromaeo/cssquery-yui.html) 05:28:59 INFO - PROCESS | 1947 | RSS: Main: 255447040 05:28:59 INFO - PROCESS | 1947 | 05:32:01 INFO - PROCESS | 1947 | Cycle 1(1): loaded http://localhost:52736/tests/dromaeo/cssquery-yui.html (next: http://localhost:52736/tests/dromaeo/cssquery-dojo.html) 05:32:02 INFO - PROCESS | 1947 | RSS: Main: 257187840 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - PROCESS | 1947 | __start_tp_report 05:32:02 INFO - PROCESS | 1947 | _x_x_mozilla_page_load 05:32:02 INFO - PROCESS | 1947 | _x_x_mozilla_page_load_details 05:32:02 INFO - PROCESS | 1947 | |i|pagename|runs| 05:32:02 INFO - PROCESS | 1947 | |0;dojo.html;3232.4181647303485;3410.505476705876;3444.1733983843856;3448.999999999999;3469.115375579227;5239.187925871486;5913.053911374181;5961.940380596193;5977.222961015062;5988.82033538994;5942.346341902387;6028.909566356498;6040.879182416349;6053.939460605393;6055.545834062441;5360.892782144365;5413.404525502192;5442.319710036246;5470.452954704518;5485.341758988927;5448.509634132927;5449.04641687705;5462.590305727066;5466.644668096581;5481.12302031675;5297.417284098746;5303.867403314929;5451.890962180754;5474.288342515468;5500.092484740013;5335.1997200419855;5379.354477462691;5392.245085688007;5410.3507579090565;5410.8917821643345;5234.816781412632;5317.229001794718;5362.276092727471;5389.67661940281;5399.811006614789;6004.369541198199;6063.9090413643835;6104.603200791934;6109.602875813102;6122.081687746829;5754.762726013927;6094.268687757498;6254.655993920333;6282.4974002079725;6302.779402720928;6183.165272688175;6298.086777417295;6333.7466501339895;6336.809895703136;6336.936630633681;6029.487493563052;6057.273127224761;6057.848553786191;6059.091136329585;6069.180660610761;6248;6295.276043255084;6304.338044505353;6427.614343139427;6433.388828061326;6219.0982307566055;6292.370762923671;6305.4009869062365;6317.273513545909;6326.398992095836;6282.057691346243;6329.4303512683155;6366.681665916685;6369.299377068612;6378.45783108441;5574.609777315549;5956.672383018976;6146.754129834846;6191.133241346215;6307.747690092345;6166;6198.442140207313;6230.7819226326865;6276.560640755103;6279.937200628026;5062.443131255559;5071.112555302807;5072.9746351268;5073.543381095719;5076.923846142237;4487.371767952489;4492.910141797146;4494.707843990195;4512.962018735643;4546.227141385973;4800;5036.64743467961;5127.64106512548;5207.557357624569;5561.972190139104;4817.735024573612;5173.22401639757;5832.591718579659;6284.685765711788;6305.684715764285;5897.734601942837;5942.851428714231;5955.255593050869;5960.76156953717;5966.701664916737;4631.722096674211;5491.588130890199;5501.092319767274;5569.749361278752;5607.971960140173;6505.316941721051;6529.6082235067;6533.248676402274;6539.019147127969;6576.80269591913;5749.741261643152;6039.973204555148;6164.845878853064;6353.872922541431;6361.77733779334;6353.8729225416155;6354.205724284465;6423.42189202974;6452.257990331172;6555.410013098844;6284.528660350401;6286.339934306832;6295.024271237966;6301.747930082745;6308.148399965946;6306.495480361652;6350.142730731292;6379.393957574023;6379.681015949277;6385.744570217139;4394.758288294047;6124.969375153096;6204.5967012144065;6236.594621349779;6262.530310226843;6248.4713258160145;6248.500119990299;6324.177856878577;6324.430801227912;6328.6519241442165;5457.935702537967;6191.071339299141;6192.969035154795;6211.503079753518;6245.843853903689;6157.291911430243;6176.3514830943905;6209.720562574786;6220.906686399617;6263.4362907338555;6228.813135605939;6230.968845155927;6246.3753624637175;6252.343503932022;6255.655938923403 05:32:02 INFO - PROCESS | 1947 | |1;ext.html;444.89544956935123;464.9930251046235;487.97072175669484;498.511458770405;529.4202847881571;39094;41167.17665646689;41206.175876482455;41366;41495;42635.78682106585;42952;42965.570344296546;42988.140237195235;43186.568134318644;9671.613135474572;9864.950675246613;9871.457069861155;9886.50567471627;9920;9701.902980970206;9809.264305177141;9811.116999470047;9820.06709362613;9825.459599722013;9709.70870873875;9772.51137443125;9814.803703925953;9844.753881152992;9845.606175752997;9787;9799.510024498783;9812.509374531244;9830.606775728998;9839.606415743361;9761;9840.16358609519;9843.310968232227;9875.209983201326;9879.357841740264;40158.79523614267;40257.59742402568;40299;40436;40500.39249411261;3028.9394212115635;3178.475551533994;3190.601174853143;3194.8402579870913;3198.4082944655315;29635.703642963508;30634.54048189279;30820.2294942626;31246.53130203049;31479.37041259185;3189;3288.901332959991;3295.307985323085;3302.2239773653173;3305.405027095122;423180.8840955806;533250;535066.3246683781;535226;535726;28530.429391412057;36619;46279;58206.83586328334;58507;34113.658863411045;34368.65631343654;34503.4824477633;34674.47988280178;34710.826445867606;14971.251437428085;15116.09303441797;15131;15132.621684457756;15181.544553663407;12773.680657983625;12894.871051289554;12899;12909.289989050692;12910.419031143621;7544.660490277951;7640.808979775439;7662.961685191538;7702.075750909927;7731.497452665559;2806.8596570171408;3210.3579284143266;3259.6251431085257;3271.656476070026;3289.194147433894;809.9757007289791;947.5215016416665;962.2686758063782;1046.1944302886734;1060.114804138553;23709.525809483715;28157.155285341472;29719;29970.55044174339;30039.098827035225;896.2740180453853;900.7477906186278;966.4877614864133;1042.2443728297076;1055.7993981143559;12738.108332416641;14588.489402870848;15011.474598389004;15183.316750746242;15242;739622;741664;746542;747358;748083;52873.735631322364;53522;53571.732141339824;53666.7316663422;53712.462875370744;1320.914140580859;1343.7917122845975;1361.6323592630133;1363.8567950365268;1364.5701603994908;22599;23457.41356466102;28430.004949826656;28756;28876.133715988555;47288.763556182;47863;47898.5210147894;47993.520064798904;48099.75950120227;667217;668605;670182;670721;672778;21864.23475178361;25472;25940.22179334623;26406.73593264043;27046.864765676044;37316.813415932746;37968.810155949046;45285;45915.311270330305;46290;37668;37737;37985.2402951945;38879.80560097181;39543.604563953995;37466.81266593649;37633;37703.62296377001;38158.85523434301;38921.41617875791;37320;37470;38108.04729881775;38262.42606360851;39525;26979;28059.298517537223;28205.576916346683;31211.687883121787;34080.829595851865;22644.773552264265;24614.138505152234;24667.753322467262;25125.87437062876;25724.485510290062 05:32:02 INFO - PROCESS | 1947 | |2;jquery.html;358.8869506105577;371.42614660349767;375.9417290319998;384.7633705271259;399.82407740594135;16343.509694709162;19626;20702.27542036029;20792.376228713125;20795.68806467904;19911.70132448011;20154;20617.27839525617;20723.792762072375;20985.160593576238;5372.409035006146;5857.853553661161;5878.764849406019;6107.633541987495;6177.166082578839;4190.622843944045;6122.724477398528;6185.783497577586;6188.81433556994;6203.2866220384785;4388.780560971954;6381.393767592094;6691.4312283455965;6735.461163106939;6792.660366981656;6622.139121914169;6766.357196066366;6793.286704895989;6890.517663763539;6933;5952.702364881782;6003.849903752397;6021.397860213988;6026.849328766816;6056.878862422771;24790.132345367827;25104.623430648557;25443.363915902064;25665.716714164217;26002;2130.8614940029;2168.27362833451;2335.404471859665;2378.2627385510546;2997.565353023821;14766.335514901855;15069.47256846005;15714.371425143096;15816.446424375206;15844.09870815498;1819.4996375996575;1838.3106335124328;1874.71879218117;1911.6367890100837;1959.9118039688249;89606.55196723975;107775;108194.45902770515;108493;108690.91309086967;10695.83956240657;10709.357438553712;10883;11188.496517656726;11512.021478174282;13980.231087290093;13984.300784960915;14018.369173387222;14025.22861242621;14071.226082565558;7452.403807695479;8636.870446943301;8799.516026618598;8816.691415800417;8832.98420681617;8172.692369220896;8867.467951922905;8895.911040889509;8908.599113039929;8932.821343573092;5618.904313658797;5655.519280861173;5762.855928601818;5864.091065884794;6795.456363490909;1529.4799768078906;1579.3208920164438;1685.4943516944868;1706.5733566608349;1797.3619365125453;796.8525822722814;851.2721623012359;860.3805260212637;908.8046070094962;950.4867371619248;20956.68564971496;22108.778912210993;22165.891705414666;22252.10991560352;22366.440838979157;948.4167237149104;965.3532133470592;984.1142971325864;990.8117457683161;992.4144754594679;11319.830202546967;11887.583934562248;11928.403579820973;11942.701432464259;12011.399430028463;575864;591767;593924;608193;610737;113115.43442282735;113134;115072;117654;119149;1005.6982905128579;1009.2430676992255;1022.2792930983638;1028.88682244953;1030.6392762533053;18529.81470185281;19482.22071117196;19828.405147845588;19842;20066.498337541678;51208.23187652114;52380.73809630927;52600.473995259556;52967.94064118773;53706.194407083145;71581;72320;72618.91071633824;72860;73447;7846.450748447553;7887.84224315522;8046.637901294573;8166.7958301042945;8224.506529608243;10443.425611591132;12492.750144997231;12881.549145779853;13070.281134537692;13098.803517947048;9176.403533770284;11103.666889993314;11329.660110196708;11486.425678715863;11604.419779011185;8505.149485051445;9160.816783664157;10639.89360106389;10856.782864342511;10961.342319460538;11020.559177632806;11180.385078820744;11294.548218071184;11513.13651476126;11609.883901161218;6783.423409010289;7273.272672732684;7917.722879699413;8270.627821747916;8272.420930534805;10027.949860250652;10824.430457583763;11241.213115081866;11288;11536.59621913229 05:32:02 INFO - PROCESS | 1947 | |3;mootools.html;1311.7865973974071;1312.5274901035625;1533.2716959444263;1776.3782676063372;1831.3041044403117;6974.9651251743735;7923.12845586985;8180.550069746161;9008.414453060555;9020.54897255137;8441.704540341088;8735.606897689604;8738.868916966234;8786.6924657637;8802.823943521125;2340.6137987232173;2345.3784747042046;2382.797462215714;2383.4875501767115;2385.6063749481314;2152.3865698275995;2186.1692556828384;2370.20598099636;2374.4657452073234;2377.2868139558063;2354.2701762453607;2359.6696462495265;2365.9881700591473;2374.4063984004;2378.916737914173;2335.4161459635093;2337.5909215887236;2346.4603141277516;2357.6463530470396;2362.6810380598745;2347.7065366829147;2349.2130136404326;2352.4118970257437;2352.9764702352927;2354.705661792276;8742.256908162813;8809.33929955256;8816.20654141124;8818.162274583905;8822.426542274796;5088.287639730441;5169.198774190007;5218.13900706383;5276.34045744282;5307.416184219733;3230.499272612749;3507.8421471033867;3571.6606922342594;3599.5500562429697;3691.6492933171307;1064.5901327988702;1067.871855377352;1077.3589714120164;1104.0670633314837;1117.3240189685205;11315.264507806965;11337.206395552315;11351.20541562091;11431.999400104949;11453.484593193327;4534.569215924482;4607.401037865056;4777.092352453023;4786.210275304606;4792.472827988919;9712.125908668253;9862.112409883144;9877.259205559612;9881.752956176153;9887.703368898945;5274.736263186825;5275.868103297372;5275.894482110336;5289.074411977888;5289.735513224324;4354.4992325882295;4493.348464472633;4662.440507139165;4805.591524720368;4820.39745031871;3893.6885049196;3926.0381206604566;3993.221321842213;4015;4047.9392809107885;1287.6458973782285;1297.3189075735315;1300.3563236197954;1311.3836496846468;1316.9407376668073;769.6805825582433;859.8194379180442;904.8371293167162;920.62254475666;923.3813345058827;5758.193852860602;5788.913166302509;5816.185733997244;5955.92793297202;6031.2159419276095;903.6656437118177;924.1820988425158;925.2782829393084;945.4091193004373;973.8003709239589;3889.5527014393706;4036.6770658347264;4058.4723985882238;4087.1880266031194;4129.112240868168;8283.461574997726;10720.088792452729;10748.247622666495;10792.892071079346;10826.296290741077;10490.527926243338;10743.570257189782;10757.677269681923;10764.515596798163;10771.730706732395;8110.310623596943;8369.995600527855;8375.45559538628;8380.20388063133;8398.244158025807;4803.735794531334;5709;5796.449337312949;5843.561732870136;5876.118582212703;8910.465372077697;9662.806743865223;9864.161546268648;9883.456409897524;10148.289619726844;9713.174380177765;10105.989401059835;10110.342827716175;10114.8482772757;10122.392656440637;7004.684789184397;7269.382102521134;7378.741744038933;7485;7692.076950765944;8224.259816616533;8402.369822263232;8453.070162282267;8458.238758511518;8484.830303394021;7330.633468326669;7430.814229644302;7571.091469023752;7582.62086895642;7696.114946781192;7352.0442342495135;7449.217832127549;7543.321101100927;7563.130240022468;7575.772726818204;6970.965145174242;7109.786706398816;7117.501774875709;7131.928680713127;7161.033260509765;4937;4953.752312384294;4986.675866068694;5076.213186956028;5094.796208151781;4987.850364489072;5013.598912086952;5080.415752188545;5082.110630639697;5141 05:32:02 INFO - PROCESS | 1947 | |4;prototype.html;307.1109139042472;308.82242710441494;314.22386704839056;318.5285777049966;319.8624591425686;4718.5281471852795;5603.943960560393;5655.462731040555;5736.311642602894;5762.250907382039;4604.158336665336;4776.689515181511;5184.740762961856;5586.162075688639;5591;3493.4934434507045;4077.898052548695;4267.226302903122;4291.8712438626735;4294.914101717964;3758.849646014156;3815.923681526368;3825.368814145663;4289.270823959934;4301.333293339521;4212.831486740527;4217.493900731916;4227.260229459847;4237.830486780541;4259.87220383389;3920.980395098035;4105.85629502966;4222.788860556975;4250.192463431954;4270.910917715963;2888.234617826257;3694.6169720530374;3722.9255414891823;3732.3654978653694;3736.7010639148803;5034.061886173813;5093.9812037592255;5270.262163297141;5393.301110150329;5396.460353964611;4421.668374871898;4668.64233562049;4810.927836082462;4819.204831202847;4834.564889159992;4787.329773831666;5205.869853253661;5879.911801322984;5922.97038514809;5944.583879128462;3014.6533148687963;3337.1490269981;3773.716971227169;3931.9213615727813;3985.20295940813;6055.666938318347;6059;6118.694065296761;6176.87646247077;6246.562740608159;3194.7763656544284;3738.3831667775057;3874.12832112778;4004.439378487014;4006.59934006597;3198.856051477689;3430.9313813723584;3816.732828701964;4059.7564146151326;4110.23960567296;4423.867283981485;4725.976370118127;4752.619790416758;4798.448178459452;4846.951530484721;5024.196128619404;5899.873067274351;6004.819855404345;6012.218411606463;6086.330503644595;1208.5135283601219;1301.173754665775;1348.298884580013;1380.6824430380868;1389.4581113365796;728.6975904999472;910.9590068446803;926.6478738079487;934.3552948465536;934.9111834375724;5555.388967185417;5594.049011668027;5601.29983752031;5622.762992141722;5636.774529018793;6100.389961003864;6131.570790044654;6140.478059364915;6149.938500614937;6186.216202708799;5226.97386513065;5513.724313784295;5566.437480012795;5573.749181286852;5605.794754127882;2339.4970081432234;2562.6935757818114;2653.12446892525;2668.9599656005175;2765.9446811064067;4750.722001818803;5295.761690723926;5360.740226046876;5360.8123715670545;5361.651492652965;4820;4930.98914722481;5198.28456609318;5256.710880901511;5267.499587539178;4618.545158275133;4947.812524994048;4974.228994505785;5329.7068661224;5346.893062138814;4617.168909596305;4631.096936097429;5159.742012899265;5208.869778255574;5222.399424066129;4474.955250447454;4496.052113104601;4585.908281834411;4839.758012099311;5135.35808023997;4384.298512238027;5134.897302053863;5297.78168504031;5317.973410132925;5336.653117547347;3058.250728571514;3210.855511502035;3392.3384939937464;3499.7025252852773;3534.9823250883583;4396.36252743344;4417.668674849463;4813.8228769012285;5120.283160357479;5764.625299355528;4656.25281084162;4985.554189285067;5316.006497563414;5383.623146379716;5505.9174112387545;4841.661083724105;5147.639665223398;5541.445855414427;6001.279846418458;6012.1582978382185;4525.864224073283;5056.241563765465;5107.668001579886;5258.029213494364;5892.322382925847;4833.782479788348;5166.199239117943;5440.564754819526;6014.48876845473;6036.219315301909;5836.416358364129;5836.474717275466;5869.7945571904775;5876.764929402776;5878.3239927408895 05:32:02 INFO - PROCESS | 1947 | |5;yui.html;667.9198496180458;703.9296070392961;713.5433322673488;753.3370633842218;760.3271105072009;15148.92425537872;15594.220288985562;15596.688066238683;15626.374945002186;15640.061596304215;14013.789793153112;14067.366968486416;14107.78838317426;14111.223882686449;14139.575812725609;645.3320812958589;662.7812821768829;827.730987429085;830.6345208108443;847.3052097280232;838.0655569040537;842.149429076634;844.5228445928032;844.9493030418164;846.5217152308957;891.3315013739696;894.2577660541734;895.9148880856309;898.1557336104041;900.3652425040364;867.8784970104222;888.5157589113949;889.1641856654757;892.9998401790004;895.50299583731;663.980080597578;664.7606861529846;665.6571865489277;665.873484038036;668.3183153183774;14338.42646294147;14367.784483232655;14454.927725361305;14573.854261457356;14582.781258281135;14286.642833929234;14300.785488217685;14373.209473478955;14532.346044428026;14713.411463541446;11377.88622113785;11773.941130294379;11899.881001189964;11949.880501194964;12232;3067.3098552825436;3843.7501562398356;3860.864869729574;3864.8840534784003;3879.709021823346;94820;98438;121003;121444.39277803554;121667.391663042;10716.249862509705;10958.452077396098;11006.944965275123;11333.659990200307;11451.198416110792;20048.69926951097;20942.95285235732;21051.8947405262;21374.572508549743;21672.56654866894;8250.587470626444;8356.432293092204;8404.411691181558;8487.830243395098;8576.957115214384;4579.748113853703;4622.67641265115;4639.768011599406;4696.530346965276;4761.071591039783;3557.2351944332095;3683.9263214735556;3690.114372550622;3692.1508053147927;3692.1692619160476;655.8588056781261;656.6454114778062;667.2993356975156;684.7432212920155;686.2348481443155;567.3730527766841;642.4860111910453;661.1075048684334;667.2693400726197;668.7358493395179;6985.476089293324;7943.920560794434;9148.085191480799;9254.259659227246;9273;586.4575267877196;619.294004834489;660.3660485933461;665.5374514712229;671.5903298987614;4409.603135717801;4643.95356046442;4650;4689.50760170184;4727.317860245749;130219;155311;159088;167887;172580;80246.5987670058;80975;83471;133458.66541334463;134318;57461.99999999916;73500.63249683718;98639.52040719395;113625;116981;9671.177949874058;9885.950570247103;9942.652007179713;10064.293025150924;10167.542460589144;51083.74458127686;54747.45252547583;62474.37525624686;63236;65621.34378656153;73025;94151;94525;96238;97796;10387.792244154924;12484;12559.309237991998;12963.41664625113;13270.336483175995;14564.053336533092;14598.489052883098;14666.266686665838;14701.338439770023;15217;12493.375331233221;13622.659433514242;13936.163830170222;14023.368948397143;14459.060161089496;11554.480048397674;13521.86478135206;14310.28448577546;14430.278486075864;14490.782638260223;13261.80107298372;13377.264250466318;13634.1137826041;14017.369218384993;14081.718365632425;10813.656114214773;10935.48741400475;11409.60066397672;11762.117841161777;11901.401778278683;9612.471314077793;10733.892661073289;11454.885451145381;11569.537218511165;11800.468978896142 05:32:02 INFO - PROCESS | 1947 | __end_tp_report 05:32:02 INFO - PROCESS | 1947 | __start_cc_report 05:32:02 INFO - PROCESS | 1947 | _x_x_mozilla_cycle_collect,360 05:32:02 INFO - PROCESS | 1947 | __end_cc_report 05:32:02 INFO - PROCESS | 1947 | __startTimestamp1474374722242__endTimestamp 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - PROCESS | 1947 | ------- Summary: start ------- 05:32:02 INFO - PROCESS | 1947 | Number of tests: 6 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - PROCESS | 1947 | [#0] dojo.html Cycles:165 Average:5824.24 Median:6094.27 stddev:670.75 (11.0%) stddev-sans-first:641.25 05:32:02 INFO - PROCESS | 1947 | Values: 3232.4 3410.5 3444.2 3449.0 3469.1 5239.2 5913.1 5961.9 5977.2 5988.8 5942.3 6028.9 6040.9 6053.9 6055.5 5360.9 5413.4 5442.3 5470.5 5485.3 5448.5 5449.0 5462.6 5466.6 5481.1 5297.4 5303.9 5451.9 5474.3 5500.1 5335.2 5379.4 5392.2 5410.4 5410.9 5234.8 5317.2 5362.3 5389.7 5399.8 6004.4 6063.9 6104.6 6109.6 6122.1 5754.8 6094.3 6254.7 6282.5 6302.8 6183.2 6298.1 6333.7 6336.8 6336.9 6029.5 6057.3 6057.8 6059.1 6069.2 6248.0 6295.3 6304.3 6427.6 6433.4 6219.1 6292.4 6305.4 6317.3 6326.4 6282.1 6329.4 6366.7 6369.3 6378.5 5574.6 5956.7 6146.8 6191.1 6307.7 6166.0 6198.4 6230.8 6276.6 6279.9 5062.4 5071.1 5073.0 5073.5 5076.9 4487.4 4492.9 4494.7 4513.0 4546.2 4800.0 5036.6 5127.6 5207.6 5562.0 4817.7 5173.2 5832.6 6284.7 6305.7 5897.7 5942.9 5955.3 5960.8 5966.7 4631.7 5491.6 5501.1 5569.7 5608.0 6505.3 6529.6 6533.2 6539.0 6576.8 5749.7 6040.0 6164.8 6353.9 6361.8 6353.9 6354.2 6423.4 6452.3 6555.4 6284.5 6286.3 6295.0 6301.7 6308.1 6306.5 6350.1 6379.4 6379.7 6385.7 4394.8 6125.0 6204.6 6236.6 6262.5 6248.5 6248.5 6324.2 6324.4 6328.7 5457.9 6191.1 6193.0 6211.5 6245.8 6157.3 6176.4 6209.7 6220.9 6263.4 6228.8 6231.0 6246.4 6252.3 6255.7 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - PROCESS | 1947 | [#1] ext.html Cycles:180 Average:74094.15 Median:39007.71 stddev:174967.73 (448.5%) stddev-sans-first:175371.18 05:32:02 INFO - PROCESS | 1947 | Values: 444.9 465.0 488.0 498.5 529.4 39094.0 41167.2 41206.2 41366.0 41495.0 42635.8 42952.0 42965.6 42988.1 43186.6 9671.6 9865.0 9871.5 9886.5 9920.0 9701.9 9809.3 9811.1 9820.1 9825.5 9709.7 9772.5 9814.8 9844.8 9845.6 9787.0 9799.5 9812.5 9830.6 9839.6 9761.0 9840.2 9843.3 9875.2 9879.4 40158.8 40257.6 40299.0 40436.0 40500.4 3028.9 3178.5 3190.6 3194.8 3198.4 29635.7 30634.5 30820.2 31246.5 31479.4 3189.0 3288.9 3295.3 3302.2 3305.4 423180.9 533250.0 535066.3 535226.0 535726.0 28530.4 36619.0 46279.0 58206.8 58507.0 34113.7 34368.7 34503.5 34674.5 34710.8 14971.3 15116.1 15131.0 15132.6 15181.5 12773.7 12894.9 12899.0 12909.3 12910.4 7544.7 7640.8 7663.0 7702.1 7731.5 2806.9 3210.4 3259.6 3271.7 3289.2 810.0 947.5 962.3 1046.2 1060.1 23709.5 28157.2 29719.0 29970.6 30039.1 896.3 900.7 966.5 1042.2 1055.8 12738.1 14588.5 15011.5 15183.3 15242.0 739622.0 741664.0 746542.0 747358.0 748083.0 52873.7 53522.0 53571.7 53666.7 53712.5 1320.9 1343.8 1361.6 1363.9 1364.6 22599.0 23457.4 28430.0 28756.0 28876.1 47288.8 47863.0 47898.5 47993.5 48099.8 667217.0 668605.0 670182.0 670721.0 672778.0 21864.2 25472.0 25940.2 26406.7 27046.9 37316.8 37968.8 45285.0 45915.3 46290.0 37668.0 37737.0 37985.2 38879.8 39543.6 37466.8 37633.0 37703.6 38158.9 38921.4 37320.0 37470.0 38108.0 38262.4 39525.0 26979.0 28059.3 28205.6 31211.7 34080.8 22644.8 24614.1 24667.8 25125.9 25724.5 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - PROCESS | 1947 | [#2] jquery.html Cycles:180 Average:34311.26 Median:24947.38 stddev:98827.96 (396.1%) stddev-sans-first:99072.32 05:32:02 INFO - PROCESS | 1947 | Values: 358.9 371.4 375.9 384.8 399.8 16343.5 19626.0 20702.3 20792.4 20795.7 19911.7 20154.0 20617.3 20723.8 20985.2 5372.4 5857.9 5878.8 6107.6 6177.2 4190.6 6122.7 6185.8 6188.8 6203.3 4388.8 6381.4 6691.4 6735.5 6792.7 6622.1 6766.4 6793.3 6890.5 6933.0 5952.7 6003.8 6021.4 6026.8 6056.9 24790.1 25104.6 25443.4 25665.7 26002.0 2130.9 2168.3 2335.4 2378.3 2997.6 14766.3 15069.5 15714.4 15816.4 15844.1 1819.5 1838.3 1874.7 1911.6 1959.9 89606.6 107775.0 108194.5 108493.0 108690.9 10695.8 10709.4 10883.0 11188.5 11512.0 13980.2 13984.3 14018.4 14025.2 14071.2 7452.4 8636.9 8799.5 8816.7 8833.0 8172.7 8867.5 8895.9 8908.6 8932.8 5618.9 5655.5 5762.9 5864.1 6795.5 1529.5 1579.3 1685.5 1706.6 1797.4 796.9 851.3 860.4 908.8 950.5 20956.7 22108.8 22165.9 22252.1 22366.4 948.4 965.4 984.1 990.8 992.4 11319.8 11887.6 11928.4 11942.7 12011.4 575864.0 591767.0 593924.0 608193.0 610737.0 113115.4 113134.0 115072.0 117654.0 119149.0 1005.7 1009.2 1022.3 1028.9 1030.6 18529.8 19482.2 19828.4 19842.0 20066.5 51208.2 52380.7 52600.5 52967.9 53706.2 71581.0 72320.0 72618.9 72860.0 73447.0 7846.5 7887.8 8046.6 8166.8 8224.5 10443.4 12492.8 12881.5 13070.3 13098.8 9176.4 11103.7 11329.7 11486.4 11604.4 8505.1 9160.8 10639.9 10856.8 10961.3 11020.6 11180.4 11294.5 11513.1 11609.9 6783.4 7273.3 7917.7 8270.6 8272.4 10027.9 10824.4 11241.2 11288.0 11536.6 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - PROCESS | 1947 | [#3] mootools.html Cycles:180 Average:5673.55 Median:5078.31 stddev:3157.29 (62.2%) stddev-sans-first:3149.13 05:32:02 INFO - PROCESS | 1947 | Values: 1311.8 1312.5 1533.3 1776.4 1831.3 6975.0 7923.1 8180.6 9008.4 9020.5 8441.7 8735.6 8738.9 8786.7 8802.8 2340.6 2345.4 2382.8 2383.5 2385.6 2152.4 2186.2 2370.2 2374.5 2377.3 2354.3 2359.7 2366.0 2374.4 2378.9 2335.4 2337.6 2346.5 2357.6 2362.7 2347.7 2349.2 2352.4 2353.0 2354.7 8742.3 8809.3 8816.2 8818.2 8822.4 5088.3 5169.2 5218.1 5276.3 5307.4 3230.5 3507.8 3571.7 3599.6 3691.6 1064.6 1067.9 1077.4 1104.1 1117.3 11315.3 11337.2 11351.2 11432.0 11453.5 4534.6 4607.4 4777.1 4786.2 4792.5 9712.1 9862.1 9877.3 9881.8 9887.7 5274.7 5275.9 5275.9 5289.1 5289.7 4354.5 4493.3 4662.4 4805.6 4820.4 3893.7 3926.0 3993.2 4015.0 4047.9 1287.6 1297.3 1300.4 1311.4 1316.9 769.7 859.8 904.8 920.6 923.4 5758.2 5788.9 5816.2 5955.9 6031.2 903.7 924.2 925.3 945.4 973.8 3889.6 4036.7 4058.5 4087.2 4129.1 8283.5 10720.1 10748.2 10792.9 10826.3 10490.5 10743.6 10757.7 10764.5 10771.7 8110.3 8370.0 8375.5 8380.2 8398.2 4803.7 5709.0 5796.4 5843.6 5876.1 8910.5 9662.8 9864.2 9883.5 10148.3 9713.2 10106.0 10110.3 10114.8 10122.4 7004.7 7269.4 7378.7 7485.0 7692.1 8224.3 8402.4 8453.1 8458.2 8484.8 7330.6 7430.8 7571.1 7582.6 7696.1 7352.0 7449.2 7543.3 7563.1 7575.8 6971.0 7109.8 7117.5 7131.9 7161.0 4937.0 4953.8 4986.7 5076.2 5094.8 4987.9 5013.6 5080.4 5082.1 5141.0 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - PROCESS | 1947 | [#4] prototype.html Cycles:180 Average:4495.84 Median:4888.97 stddev:1409.31 (28.8%) stddev-sans-first:1377.75 05:32:02 INFO - PROCESS | 1947 | Values: 307.1 308.8 314.2 318.5 319.9 4718.5 5603.9 5655.5 5736.3 5762.3 4604.2 4776.7 5184.7 5586.2 5591.0 3493.5 4077.9 4267.2 4291.9 4294.9 3758.8 3815.9 3825.4 4289.3 4301.3 4212.8 4217.5 4227.3 4237.8 4259.9 3921.0 4105.9 4222.8 4250.2 4270.9 2888.2 3694.6 3722.9 3732.4 3736.7 5034.1 5094.0 5270.3 5393.3 5396.5 4421.7 4668.6 4810.9 4819.2 4834.6 4787.3 5205.9 5879.9 5923.0 5944.6 3014.7 3337.1 3773.7 3931.9 3985.2 6055.7 6059.0 6118.7 6176.9 6246.6 3194.8 3738.4 3874.1 4004.4 4006.6 3198.9 3430.9 3816.7 4059.8 4110.2 4423.9 4726.0 4752.6 4798.4 4847.0 5024.2 5899.9 6004.8 6012.2 6086.3 1208.5 1301.2 1348.3 1380.7 1389.5 728.7 911.0 926.6 934.4 934.9 5555.4 5594.0 5601.3 5622.8 5636.8 6100.4 6131.6 6140.5 6149.9 6186.2 5227.0 5513.7 5566.4 5573.7 5605.8 2339.5 2562.7 2653.1 2669.0 2765.9 4750.7 5295.8 5360.7 5360.8 5361.7 4820.0 4931.0 5198.3 5256.7 5267.5 4618.5 4947.8 4974.2 5329.7 5346.9 4617.2 4631.1 5159.7 5208.9 5222.4 4475.0 4496.1 4585.9 4839.8 5135.4 4384.3 5134.9 5297.8 5318.0 5336.7 3058.3 3210.9 3392.3 3499.7 3535.0 4396.4 4417.7 4813.8 5120.3 5764.6 4656.3 4985.6 5316.0 5383.6 5505.9 4841.7 5147.6 5541.4 6001.3 6012.2 4525.9 5056.2 5107.7 5258.0 5892.3 4833.8 5166.2 5440.6 6014.5 6036.2 5836.4 5836.5 5869.8 5876.8 5878.3 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - PROCESS | 1947 | [#5] yui.html Cycles:180 Average:23801.73 Median:3862.87 stddev:38200.61 (988.9%) stddev-sans-first:38268.28 05:32:02 INFO - PROCESS | 1947 | Values: 667.9 703.9 713.5 753.3 760.3 15148.9 15594.2 15596.7 15626.4 15640.1 14013.8 14067.4 14107.8 14111.2 14139.6 645.3 662.8 827.7 830.6 847.3 838.1 842.1 844.5 844.9 846.5 891.3 894.3 895.9 898.2 900.4 867.9 888.5 889.2 893.0 895.5 664.0 664.8 665.7 665.9 668.3 14338.4 14367.8 14454.9 14573.9 14582.8 14286.6 14300.8 14373.2 14532.3 14713.4 11377.9 11773.9 11899.9 11949.9 12232.0 3067.3 3843.8 3860.9 3864.9 3879.7 94820.0 98438.0 121003.0 121444.4 121667.4 10716.2 10958.5 11006.9 11333.7 11451.2 20048.7 20943.0 21051.9 21374.6 21672.6 8250.6 8356.4 8404.4 8487.8 8577.0 4579.7 4622.7 4639.8 4696.5 4761.1 3557.2 3683.9 3690.1 3692.2 3692.2 655.9 656.6 667.3 684.7 686.2 567.4 642.5 661.1 667.3 668.7 6985.5 7943.9 9148.1 9254.3 9273.0 586.5 619.3 660.4 665.5 671.6 4409.6 4644.0 4650.0 4689.5 4727.3 130219.0 155311.0 159088.0 167887.0 172580.0 80246.6 80975.0 83471.0 133458.7 134318.0 57462.0 73500.6 98639.5 113625.0 116981.0 9671.2 9886.0 9942.7 10064.3 10167.5 51083.7 54747.5 62474.4 63236.0 65621.3 73025.0 94151.0 94525.0 96238.0 97796.0 10387.8 12484.0 12559.3 12963.4 13270.3 14564.1 14598.5 14666.3 14701.3 15217.0 12493.4 13622.7 13936.2 14023.4 14459.1 11554.5 13521.9 14310.3 14430.3 14490.8 13261.8 13377.3 13634.1 14017.4 14081.7 10813.7 10935.5 11409.6 11762.1 11901.4 9612.5 10733.9 11454.9 11569.5 11800.5 05:32:02 INFO - PROCESS | 1947 | -------- Summary: end -------- 05:32:02 INFO - PROCESS | 1947 | 05:32:02 INFO - TEST-INFO | 1947: exit 0 05:32:02 INFO - TEST-OK | dromaeo_css | took 1114319ms 05:32:02 INFO - TEST-START | kraken 05:32:02 INFO - operating with platform_type : mac_ 05:32:02 INFO - Initialising browser for kraken test... 05:32:02 INFO - TEST-INFO | started process 1953 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/tmpGl_aYM/profile http://localhost:52736/getInfo.html) 05:32:05 INFO - PROCESS | 1953 | __metrics Screen width/height:1600/1200 05:32:05 INFO - PROCESS | 1953 | colorDepth:24 05:32:05 INFO - PROCESS | 1953 | Browser inner width/height: 1024/689 05:32:05 INFO - PROCESS | 1953 | __metrics 05:32:05 ERROR - PROCESS | 1953 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 05:32:06 INFO - TEST-INFO | 1953: exit 0 05:32:06 INFO - Browser initialized. 05:32:06 INFO - Running cycle 1/1 for kraken test... 05:32:06 INFO - TEST-INFO | started process 1955 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/T/tmpGl_aYM/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:32:18 INFO - PROCESS | 1955 | RSS: Main: 225009664 05:32:18 INFO - PROCESS | 1955 | 05:32:21 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52736/tests/kraken/driver.html?testName=audio-beat-detection) 05:32:22 INFO - PROCESS | 1955 | RSS: Main: 237453312 05:32:22 INFO - PROCESS | 1955 | 05:32:24 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52736/tests/kraken/driver.html?testName=audio-dft) 05:32:25 INFO - PROCESS | 1955 | RSS: Main: 246005760 05:32:25 INFO - PROCESS | 1955 | 05:32:28 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52736/tests/kraken/driver.html?testName=audio-fft) 05:32:29 INFO - PROCESS | 1955 | RSS: Main: 249098240 05:32:29 INFO - PROCESS | 1955 | 05:32:31 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52736/tests/kraken/driver.html?testName=audio-oscillator) 05:32:31 INFO - PROCESS | 1955 | RSS: Main: 249610240 05:32:31 INFO - PROCESS | 1955 | 05:32:33 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52736/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:32:34 INFO - PROCESS | 1955 | RSS: Main: 249647104 05:32:34 INFO - PROCESS | 1955 | 05:32:37 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52736/tests/kraken/driver.html?testName=imaging-darkroom) 05:32:37 INFO - PROCESS | 1955 | RSS: Main: 251052032 05:32:37 INFO - PROCESS | 1955 | 05:32:40 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52736/tests/kraken/driver.html?testName=imaging-desaturate) 05:32:41 INFO - PROCESS | 1955 | RSS: Main: 251064320 05:32:41 INFO - PROCESS | 1955 | 05:32:44 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52736/tests/kraken/driver.html?testName=json-parse-financial) 05:32:45 INFO - PROCESS | 1955 | RSS: Main: 251326464 05:32:45 INFO - PROCESS | 1955 | 05:32:46 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52736/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:32:47 INFO - PROCESS | 1955 | RSS: Main: 250761216 05:32:47 INFO - PROCESS | 1955 | 05:32:49 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52736/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:32:50 INFO - PROCESS | 1955 | RSS: Main: 250802176 05:32:50 INFO - PROCESS | 1955 | 05:32:52 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52736/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:32:52 INFO - PROCESS | 1955 | RSS: Main: 250908672 05:32:52 INFO - PROCESS | 1955 | 05:32:55 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52736/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:32:56 INFO - PROCESS | 1955 | RSS: Main: 250933248 05:32:56 INFO - PROCESS | 1955 | 05:32:59 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52736/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:33:00 INFO - PROCESS | 1955 | RSS: Main: 251305984 05:33:00 INFO - PROCESS | 1955 | 05:33:01 INFO - PROCESS | 1955 | Cycle 1(1): loaded http://localhost:52736/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52736/tests/kraken/driver.html?testName=ai-astar) 05:33:02 INFO - PROCESS | 1955 | RSS: Main: 252915712 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | __start_tp_report 05:33:02 INFO - PROCESS | 1955 | _x_x_mozilla_page_load 05:33:02 INFO - PROCESS | 1955 | _x_x_mozilla_page_load_details 05:33:02 INFO - PROCESS | 1955 | |i|pagename|runs| 05:33:02 INFO - PROCESS | 1955 | |0;ai-astar;92;126;118;116;115;121;122;119;116;118 05:33:02 INFO - PROCESS | 1955 | |1;audio-beat-detection;152;111;110;146;113;111;114;112;137;112 05:33:02 INFO - PROCESS | 1955 | |2;audio-dft;196;202;194;230;283;201;197;197;198;196 05:33:02 INFO - PROCESS | 1955 | |3;audio-fft;83;59;59;86;61;59;63;81;108;49 05:33:02 INFO - PROCESS | 1955 | |4;audio-oscillator;88;70;92;75;100;103;125;76;69;88 05:33:02 INFO - PROCESS | 1955 | |5;imaging-gaussian-blur;136;123;90;74;93;88;92;90;91;88 05:33:02 INFO - PROCESS | 1955 | |6;imaging-darkroom;96;124;124;97;96;96;98;97;97;99 05:33:02 INFO - PROCESS | 1955 | |7;imaging-desaturate;95;101;99;149;93;95;122;151;77;143 05:33:02 INFO - PROCESS | 1955 | |8;json-parse-financial;55;54;56;56;59;59;61;59;60;60 05:33:02 INFO - PROCESS | 1955 | |9;json-stringify-tinderbox;71;71;69;87;94;69;68;70;72;73 05:33:02 INFO - PROCESS | 1955 | |10;stanford-crypto-aes;85;83;84;83;83;87;83;87;88;90 05:33:02 INFO - PROCESS | 1955 | |11;stanford-crypto-ccm;152;156;146;138;137;138;134;155;189;144 05:33:02 INFO - PROCESS | 1955 | |12;stanford-crypto-pbkdf2;186;154;190;154;216;151;170;204;227;203 05:33:02 INFO - PROCESS | 1955 | |13;stanford-crypto-sha256-iterative;69;79;89;87;88;88;93;73;85;59 05:33:02 INFO - PROCESS | 1955 | __end_tp_report 05:33:02 INFO - PROCESS | 1955 | __start_cc_report 05:33:02 INFO - PROCESS | 1955 | _x_x_mozilla_cycle_collect,947 05:33:02 INFO - PROCESS | 1955 | __end_cc_report 05:33:02 INFO - PROCESS | 1955 | __startTimestamp1474374782177__endTimestamp 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | ------- Summary: start ------- 05:33:02 INFO - PROCESS | 1955 | Number of tests: 14 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#0] ai-astar Cycles:10 Average:116.30 Median:120.00 stddev:9.15 (7.6%) stddev-sans-first:3.50 05:33:02 INFO - PROCESS | 1955 | Values: 92.0 126.0 118.0 116.0 115.0 121.0 122.0 119.0 116.0 118.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#1] audio-beat-detection Cycles:10 Average:121.80 Median:113.50 stddev:16.44 (14.5%) stddev-sans-first:13.31 05:33:02 INFO - PROCESS | 1955 | Values: 152.0 111.0 110.0 146.0 113.0 111.0 114.0 112.0 137.0 112.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#2] audio-dft Cycles:10 Average:209.40 Median:199.50 stddev:27.89 (14.0%) stddev-sans-first:29.16 05:33:02 INFO - PROCESS | 1955 | Values: 196.0 202.0 194.0 230.0 283.0 201.0 197.0 197.0 198.0 196.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#3] audio-fft Cycles:10 Average:70.80 Median:62.00 stddev:18.00 (29.0%) stddev-sans-first:18.55 05:33:02 INFO - PROCESS | 1955 | Values: 83.0 59.0 59.0 86.0 61.0 59.0 63.0 81.0 108.0 49.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#4] audio-oscillator Cycles:10 Average:88.60 Median:75.50 stddev:17.48 (23.1%) stddev-sans-first:18.53 05:33:02 INFO - PROCESS | 1955 | Values: 88.0 70.0 92.0 75.0 100.0 103.0 125.0 76.0 69.0 88.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#5] imaging-gaussian-blur Cycles:10 Average:96.50 Median:90.00 stddev:18.44 (20.5%) stddev-sans-first:12.88 05:33:02 INFO - PROCESS | 1955 | Values: 136.0 123.0 90.0 74.0 93.0 88.0 92.0 90.0 91.0 88.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#6] imaging-darkroom Cycles:10 Average:102.40 Median:97.00 stddev:11.42 (11.8%) stddev-sans-first:11.88 05:33:02 INFO - PROCESS | 1955 | Values: 96.0 124.0 124.0 97.0 96.0 96.0 98.0 97.0 97.0 99.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#7] imaging-desaturate Cycles:10 Average:112.50 Median:85.00 stddev:26.67 (31.4%) stddev-sans-first:27.53 05:33:02 INFO - PROCESS | 1955 | Values: 95.0 101.0 99.0 149.0 93.0 95.0 122.0 151.0 77.0 143.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#8] json-parse-financial Cycles:10 Average:57.90 Median:59.00 stddev:2.42 (4.1%) stddev-sans-first:2.33 05:33:02 INFO - PROCESS | 1955 | Values: 55.0 54.0 56.0 56.0 59.0 59.0 61.0 59.0 60.0 60.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#9] json-stringify-tinderbox Cycles:10 Average:74.40 Median:71.50 stddev:8.77 (12.3%) stddev-sans-first:9.22 05:33:02 INFO - PROCESS | 1955 | Values: 71.0 71.0 69.0 87.0 94.0 69.0 68.0 70.0 72.0 73.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#10] stanford-crypto-aes Cycles:10 Average:85.30 Median:86.00 stddev:2.54 (3.0%) stddev-sans-first:2.69 05:33:02 INFO - PROCESS | 1955 | Values: 85.0 83.0 84.0 83.0 83.0 87.0 83.0 87.0 88.0 90.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#11] stanford-crypto-ccm Cycles:10 Average:148.90 Median:149.00 stddev:16.12 (10.8%) stddev-sans-first:17.06 05:33:02 INFO - PROCESS | 1955 | Values: 152.0 156.0 146.0 138.0 137.0 138.0 134.0 155.0 189.0 144.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:185.50 Median:196.50 stddev:27.36 (13.9%) stddev-sans-first:29.02 05:33:02 INFO - PROCESS | 1955 | Values: 186.0 154.0 190.0 154.0 216.0 151.0 170.0 204.0 227.0 203.0 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - PROCESS | 1955 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:81.00 Median:87.50 stddev:10.82 (12.4%) stddev-sans-first:10.57 05:33:02 INFO - PROCESS | 1955 | Values: 69.0 79.0 89.0 87.0 88.0 88.0 93.0 73.0 85.0 59.0 05:33:02 INFO - PROCESS | 1955 | -------- Summary: end -------- 05:33:02 INFO - PROCESS | 1955 | 05:33:02 INFO - TEST-INFO | 1955: exit 0 05:33:03 INFO - TEST-OK | kraken | took 60164ms 05:33:03 INFO - SUITE-END | took 1174s 05:33:03 INFO - Completed test suite (00:19:34) 05:33:03 INFO - javascript benchmark 05:33:03 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7265.402740610505, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3232.4181647303485, 3410.505476705876, 3444.1733983843856, 3448.999999999999, 3469.115375579227, 5239.187925871486, 5913.053911374181, 5961.940380596193, 5977.222961015062, 5988.82033538994, 5942.346341902387, 6028.909566356498, 6040.879182416349, 6053.939460605393, 6055.545834062441, 5360.892782144365, 5413.404525502192, 5442.319710036246, 5470.452954704518, 5485.341758988927, 5448.509634132927, 5449.04641687705, 5462.590305727066, 5466.644668096581, 5481.12302031675, 5297.417284098746, 5303.867403314929, 5451.890962180754, 5474.288342515468, 5500.092484740013, 5335.1997200419855, 5379.354477462691, 5392.245085688007, 5410.3507579090565, 5410.8917821643345, 5234.816781412632, 5317.229001794718, 5362.276092727471, 5389.67661940281, 5399.811006614789, 6004.369541198199, 6063.9090413643835, 6104.603200791934, 6109.602875813102, 6122.081687746829, 5754.762726013927, 6094.268687757498, 6254.655993920333, 6282.4974002079725, 6302.779402720928, 6183.165272688175, 6298.086777417295, 6333.7466501339895, 6336.809895703136, 6336.936630633681, 6029.487493563052, 6057.273127224761, 6057.848553786191, 6059.091136329585, 6069.180660610761, 6248.0, 6295.276043255084, 6304.338044505353, 6427.614343139427, 6433.388828061326, 6219.0982307566055, 6292.370762923671, 6305.4009869062365, 6317.273513545909, 6326.398992095836, 6282.057691346243, 6329.4303512683155, 6366.681665916685, 6369.299377068612, 6378.45783108441, 5574.609777315549, 5956.672383018976, 6146.754129834846, 6191.133241346215, 6307.747690092345, 6166.0, 6198.442140207313, 6230.7819226326865, 6276.560640755103, 6279.937200628026, 5062.443131255559, 5071.112555302807, 5072.9746351268, 5073.543381095719, 5076.923846142237, 4487.371767952489, 4492.910141797146, 4494.707843990195, 4512.962018735643, 4546.227141385973, 4800.0, 5036.64743467961, 5127.64106512548, 5207.557357624569, 5561.972190139104, 4817.735024573612, 5173.22401639757, 5832.591718579659, 6284.685765711788, 6305.684715764285, 5897.734601942837, 5942.851428714231, 5955.255593050869, 5960.76156953717, 5966.701664916737, 4631.722096674211, 5491.588130890199, 5501.092319767274, 5569.749361278752, 5607.971960140173, 6505.316941721051, 6529.6082235067, 6533.248676402274, 6539.019147127969, 6576.80269591913, 5749.741261643152, 6039.973204555148, 6164.845878853064, 6353.872922541431, 6361.77733779334, 6353.8729225416155, 6354.205724284465, 6423.42189202974, 6452.257990331172, 6555.410013098844, 6284.528660350401, 6286.339934306832, 6295.024271237966, 6301.747930082745, 6308.148399965946, 6306.495480361652, 6350.142730731292, 6379.393957574023, 6379.681015949277, 6385.744570217139, 4394.758288294047, 6124.969375153096, 6204.5967012144065, 6236.594621349779, 6262.530310226843, 6248.4713258160145, 6248.500119990299, 6324.177856878577, 6324.430801227912, 6328.6519241442165, 5457.935702537967, 6191.071339299141, 6192.969035154795, 6211.503079753518, 6245.843853903689, 6157.291911430243, 6176.3514830943905, 6209.720562574786, 6220.906686399617, 6263.4362907338555, 6228.813135605939, 6230.968845155927, 6246.3753624637175, 6252.343503932022, 6255.655938923403], "value": 5782.851991139778, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [444.89544956935123, 464.9930251046235, 487.97072175669484, 498.511458770405, 529.4202847881571, 39094.0, 41167.17665646689, 41206.175876482455, 41366.0, 41495.0, 42635.78682106585, 42952.0, 42965.570344296546, 42988.140237195235, 43186.568134318644, 9671.613135474572, 9864.950675246613, 9871.457069861155, 9886.50567471627, 9920.0, 9701.902980970206, 9809.264305177141, 9811.116999470047, 9820.06709362613, 9825.459599722013, 9709.70870873875, 9772.51137443125, 9814.803703925953, 9844.753881152992, 9845.606175752997, 9787.0, 9799.510024498783, 9812.509374531244, 9830.606775728998, 9839.606415743361, 9761.0, 9840.16358609519, 9843.310968232227, 9875.209983201326, 9879.357841740264, 40158.79523614267, 40257.59742402568, 40299.0, 40436.0, 40500.39249411261, 3028.9394212115635, 3178.475551533994, 3190.601174853143, 3194.8402579870913, 3198.4082944655315, 29635.703642963508, 30634.54048189279, 30820.2294942626, 31246.53130203049, 31479.37041259185, 3189.0, 3288.901332959991, 3295.307985323085, 3302.2239773653173, 3305.405027095122, 423180.8840955806, 533250.0, 535066.3246683781, 535226.0, 535726.0, 28530.429391412057, 36619.0, 46279.0, 58206.83586328334, 58507.0, 34113.658863411045, 34368.65631343654, 34503.4824477633, 34674.47988280178, 34710.826445867606, 14971.251437428085, 15116.09303441797, 15131.0, 15132.621684457756, 15181.544553663407, 12773.680657983625, 12894.871051289554, 12899.0, 12909.289989050692, 12910.419031143621, 7544.660490277951, 7640.808979775439, 7662.961685191538, 7702.075750909927, 7731.497452665559, 2806.8596570171408, 3210.3579284143266, 3259.6251431085257, 3271.656476070026, 3289.194147433894, 809.9757007289791, 947.5215016416665, 962.2686758063782, 1046.1944302886734, 1060.114804138553, 23709.525809483715, 28157.155285341472, 29719.0, 29970.55044174339, 30039.098827035225, 896.2740180453853, 900.7477906186278, 966.4877614864133, 1042.2443728297076, 1055.7993981143559, 12738.108332416641, 14588.489402870848, 15011.474598389004, 15183.316750746242, 15242.0, 739622.0, 741664.0, 746542.0, 747358.0, 748083.0, 52873.735631322364, 53522.0, 53571.732141339824, 53666.7316663422, 53712.462875370744, 1320.914140580859, 1343.7917122845975, 1361.6323592630133, 1363.8567950365268, 1364.5701603994908, 22599.0, 23457.41356466102, 28430.004949826656, 28756.0, 28876.133715988555, 47288.763556182, 47863.0, 47898.5210147894, 47993.520064798904, 48099.75950120227, 667217.0, 668605.0, 670182.0, 670721.0, 672778.0, 21864.23475178361, 25472.0, 25940.22179334623, 26406.73593264043, 27046.864765676044, 37316.813415932746, 37968.810155949046, 45285.0, 45915.311270330305, 46290.0, 37668.0, 37737.0, 37985.2402951945, 38879.80560097181, 39543.604563953995, 37466.81266593649, 37633.0, 37703.62296377001, 38158.85523434301, 38921.41617875791, 37320.0, 37470.0, 38108.04729881775, 38262.42606360851, 39525.0, 26979.0, 28059.298517537223, 28205.576916346683, 31211.687883121787, 34080.829595851865, 22644.773552264265, 24614.138505152234, 24667.753322467262, 25125.87437062876, 25724.485510290062], "value": 18322.601676481376, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [358.8869506105577, 371.42614660349767, 375.9417290319998, 384.7633705271259, 399.82407740594135, 16343.509694709162, 19626.0, 20702.27542036029, 20792.376228713125, 20795.68806467904, 19911.70132448011, 20154.0, 20617.27839525617, 20723.792762072375, 20985.160593576238, 5372.409035006146, 5857.853553661161, 5878.764849406019, 6107.633541987495, 6177.166082578839, 4190.622843944045, 6122.724477398528, 6185.783497577586, 6188.81433556994, 6203.2866220384785, 4388.780560971954, 6381.393767592094, 6691.4312283455965, 6735.461163106939, 6792.660366981656, 6622.139121914169, 6766.357196066366, 6793.286704895989, 6890.517663763539, 6933.0, 5952.702364881782, 6003.849903752397, 6021.397860213988, 6026.849328766816, 6056.878862422771, 24790.132345367827, 25104.623430648557, 25443.363915902064, 25665.716714164217, 26002.0, 2130.8614940029, 2168.27362833451, 2335.404471859665, 2378.2627385510546, 2997.565353023821, 14766.335514901855, 15069.47256846005, 15714.371425143096, 15816.446424375206, 15844.09870815498, 1819.4996375996575, 1838.3106335124328, 1874.71879218117, 1911.6367890100837, 1959.9118039688249, 89606.55196723975, 107775.0, 108194.45902770515, 108493.0, 108690.91309086967, 10695.83956240657, 10709.357438553712, 10883.0, 11188.496517656726, 11512.021478174282, 13980.231087290093, 13984.300784960915, 14018.369173387222, 14025.22861242621, 14071.226082565558, 7452.403807695479, 8636.870446943301, 8799.516026618598, 8816.691415800417, 8832.98420681617, 8172.692369220896, 8867.467951922905, 8895.911040889509, 8908.599113039929, 8932.821343573092, 5618.904313658797, 5655.519280861173, 5762.855928601818, 5864.091065884794, 6795.456363490909, 1529.4799768078906, 1579.3208920164438, 1685.4943516944868, 1706.5733566608349, 1797.3619365125453, 796.8525822722814, 851.2721623012359, 860.3805260212637, 908.8046070094962, 950.4867371619248, 20956.68564971496, 22108.778912210993, 22165.891705414666, 22252.10991560352, 22366.440838979157, 948.4167237149104, 965.3532133470592, 984.1142971325864, 990.8117457683161, 992.4144754594679, 11319.830202546967, 11887.583934562248, 11928.403579820973, 11942.701432464259, 12011.399430028463, 575864.0, 591767.0, 593924.0, 608193.0, 610737.0, 113115.43442282735, 113134.0, 115072.0, 117654.0, 119149.0, 1005.6982905128579, 1009.2430676992255, 1022.2792930983638, 1028.88682244953, 1030.6392762533053, 18529.81470185281, 19482.22071117196, 19828.405147845588, 19842.0, 20066.498337541678, 51208.23187652114, 52380.73809630927, 52600.473995259556, 52967.94064118773, 53706.194407083145, 71581.0, 72320.0, 72618.91071633824, 72860.0, 73447.0, 7846.450748447553, 7887.84224315522, 8046.637901294573, 8166.7958301042945, 8224.506529608243, 10443.425611591132, 12492.750144997231, 12881.549145779853, 13070.281134537692, 13098.803517947048, 9176.403533770284, 11103.666889993314, 11329.660110196708, 11486.425678715863, 11604.419779011185, 8505.149485051445, 9160.816783664157, 10639.89360106389, 10856.782864342511, 10961.342319460538, 11020.559177632806, 11180.385078820744, 11294.548218071184, 11513.13651476126, 11609.883901161218, 6783.423409010289, 7273.272672732684, 7917.722879699413, 8270.627821747916, 8272.420930534805, 10027.949860250652, 10824.430457583763, 11241.213115081866, 11288.0, 11536.59621913229], "value": 9701.34439444666, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1311.7865973974071, 1312.5274901035625, 1533.2716959444263, 1776.3782676063372, 1831.3041044403117, 6974.9651251743735, 7923.12845586985, 8180.550069746161, 9008.414453060555, 9020.54897255137, 8441.704540341088, 8735.606897689604, 8738.868916966234, 8786.6924657637, 8802.823943521125, 2340.6137987232173, 2345.3784747042046, 2382.797462215714, 2383.4875501767115, 2385.6063749481314, 2152.3865698275995, 2186.1692556828384, 2370.20598099636, 2374.4657452073234, 2377.2868139558063, 2354.2701762453607, 2359.6696462495265, 2365.9881700591473, 2374.4063984004, 2378.916737914173, 2335.4161459635093, 2337.5909215887236, 2346.4603141277516, 2357.6463530470396, 2362.6810380598745, 2347.7065366829147, 2349.2130136404326, 2352.4118970257437, 2352.9764702352927, 2354.705661792276, 8742.256908162813, 8809.33929955256, 8816.20654141124, 8818.162274583905, 8822.426542274796, 5088.287639730441, 5169.198774190007, 5218.13900706383, 5276.34045744282, 5307.416184219733, 3230.499272612749, 3507.8421471033867, 3571.6606922342594, 3599.5500562429697, 3691.6492933171307, 1064.5901327988702, 1067.871855377352, 1077.3589714120164, 1104.0670633314837, 1117.3240189685205, 11315.264507806965, 11337.206395552315, 11351.20541562091, 11431.999400104949, 11453.484593193327, 4534.569215924482, 4607.401037865056, 4777.092352453023, 4786.210275304606, 4792.472827988919, 9712.125908668253, 9862.112409883144, 9877.259205559612, 9881.752956176153, 9887.703368898945, 5274.736263186825, 5275.868103297372, 5275.894482110336, 5289.074411977888, 5289.735513224324, 4354.4992325882295, 4493.348464472633, 4662.440507139165, 4805.591524720368, 4820.39745031871, 3893.6885049196, 3926.0381206604566, 3993.221321842213, 4015.0, 4047.9392809107885, 1287.6458973782285, 1297.3189075735315, 1300.3563236197954, 1311.3836496846468, 1316.9407376668073, 769.6805825582433, 859.8194379180442, 904.8371293167162, 920.62254475666, 923.3813345058827, 5758.193852860602, 5788.913166302509, 5816.185733997244, 5955.92793297202, 6031.2159419276095, 903.6656437118177, 924.1820988425158, 925.2782829393084, 945.4091193004373, 973.8003709239589, 3889.5527014393706, 4036.6770658347264, 4058.4723985882238, 4087.1880266031194, 4129.112240868168, 8283.461574997726, 10720.088792452729, 10748.247622666495, 10792.892071079346, 10826.296290741077, 10490.527926243338, 10743.570257189782, 10757.677269681923, 10764.515596798163, 10771.730706732395, 8110.310623596943, 8369.995600527855, 8375.45559538628, 8380.20388063133, 8398.244158025807, 4803.735794531334, 5709.0, 5796.449337312949, 5843.561732870136, 5876.118582212703, 8910.465372077697, 9662.806743865223, 9864.161546268648, 9883.456409897524, 10148.289619726844, 9713.174380177765, 10105.989401059835, 10110.342827716175, 10114.8482772757, 10122.392656440637, 7004.684789184397, 7269.382102521134, 7378.741744038933, 7485.0, 7692.076950765944, 8224.259816616533, 8402.369822263232, 8453.070162282267, 8458.238758511518, 8484.830303394021, 7330.633468326669, 7430.814229644302, 7571.091469023752, 7582.62086895642, 7696.114946781192, 7352.0442342495135, 7449.217832127549, 7543.321101100927, 7563.130240022468, 7575.772726818204, 6970.965145174242, 7109.786706398816, 7117.501774875709, 7131.928680713127, 7161.033260509765, 4937.0, 4953.752312384294, 4986.675866068694, 5076.213186956028, 5094.796208151781, 4987.850364489072, 5013.598912086952, 5080.415752188545, 5082.110630639697, 5141.0], "value": 4567.894750380229, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [307.1109139042472, 308.82242710441494, 314.22386704839056, 318.5285777049966, 319.8624591425686, 4718.5281471852795, 5603.943960560393, 5655.462731040555, 5736.311642602894, 5762.250907382039, 4604.158336665336, 4776.689515181511, 5184.740762961856, 5586.162075688639, 5591.0, 3493.4934434507045, 4077.898052548695, 4267.226302903122, 4291.8712438626735, 4294.914101717964, 3758.849646014156, 3815.923681526368, 3825.368814145663, 4289.270823959934, 4301.333293339521, 4212.831486740527, 4217.493900731916, 4227.260229459847, 4237.830486780541, 4259.87220383389, 3920.980395098035, 4105.85629502966, 4222.788860556975, 4250.192463431954, 4270.910917715963, 2888.234617826257, 3694.6169720530374, 3722.9255414891823, 3732.3654978653694, 3736.7010639148803, 5034.061886173813, 5093.9812037592255, 5270.262163297141, 5393.301110150329, 5396.460353964611, 4421.668374871898, 4668.64233562049, 4810.927836082462, 4819.204831202847, 4834.564889159992, 4787.329773831666, 5205.869853253661, 5879.911801322984, 5922.97038514809, 5944.583879128462, 3014.6533148687963, 3337.1490269981, 3773.716971227169, 3931.9213615727813, 3985.20295940813, 6055.666938318347, 6059.0, 6118.694065296761, 6176.87646247077, 6246.562740608159, 3194.7763656544284, 3738.3831667775057, 3874.12832112778, 4004.439378487014, 4006.59934006597, 3198.856051477689, 3430.9313813723584, 3816.732828701964, 4059.7564146151326, 4110.23960567296, 4423.867283981485, 4725.976370118127, 4752.619790416758, 4798.448178459452, 4846.951530484721, 5024.196128619404, 5899.873067274351, 6004.819855404345, 6012.218411606463, 6086.330503644595, 1208.5135283601219, 1301.173754665775, 1348.298884580013, 1380.6824430380868, 1389.4581113365796, 728.6975904999472, 910.9590068446803, 926.6478738079487, 934.3552948465536, 934.9111834375724, 5555.388967185417, 5594.049011668027, 5601.29983752031, 5622.762992141722, 5636.774529018793, 6100.389961003864, 6131.570790044654, 6140.478059364915, 6149.938500614937, 6186.216202708799, 5226.97386513065, 5513.724313784295, 5566.437480012795, 5573.749181286852, 5605.794754127882, 2339.4970081432234, 2562.6935757818114, 2653.12446892525, 2668.9599656005175, 2765.9446811064067, 4750.722001818803, 5295.761690723926, 5360.740226046876, 5360.8123715670545, 5361.651492652965, 4820.0, 4930.98914722481, 5198.28456609318, 5256.710880901511, 5267.499587539178, 4618.545158275133, 4947.812524994048, 4974.228994505785, 5329.7068661224, 5346.893062138814, 4617.168909596305, 4631.096936097429, 5159.742012899265, 5208.869778255574, 5222.399424066129, 4474.955250447454, 4496.052113104601, 4585.908281834411, 4839.758012099311, 5135.35808023997, 4384.298512238027, 5134.897302053863, 5297.78168504031, 5317.973410132925, 5336.653117547347, 3058.250728571514, 3210.855511502035, 3392.3384939937464, 3499.7025252852773, 3534.9823250883583, 4396.36252743344, 4417.668674849463, 4813.8228769012285, 5120.283160357479, 5764.625299355528, 4656.25281084162, 4985.554189285067, 5316.006497563414, 5383.623146379716, 5505.9174112387545, 4841.661083724105, 5147.639665223398, 5541.445855414427, 6001.279846418458, 6012.1582978382185, 4525.864224073283, 5056.241563765465, 5107.668001579886, 5258.029213494364, 5892.322382925847, 4833.782479788348, 5166.199239117943, 5440.564754819526, 6014.48876845473, 6036.219315301909, 5836.416358364129, 5836.474717275466, 5869.7945571904775, 5876.764929402776, 5878.3239927408895], "value": 4052.718954799969, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [667.9198496180458, 703.9296070392961, 713.5433322673488, 753.3370633842218, 760.3271105072009, 15148.92425537872, 15594.220288985562, 15596.688066238683, 15626.374945002186, 15640.061596304215, 14013.789793153112, 14067.366968486416, 14107.78838317426, 14111.223882686449, 14139.575812725609, 645.3320812958589, 662.7812821768829, 827.730987429085, 830.6345208108443, 847.3052097280232, 838.0655569040537, 842.149429076634, 844.5228445928032, 844.9493030418164, 846.5217152308957, 891.3315013739696, 894.2577660541734, 895.9148880856309, 898.1557336104041, 900.3652425040364, 867.8784970104222, 888.5157589113949, 889.1641856654757, 892.9998401790004, 895.50299583731, 663.980080597578, 664.7606861529846, 665.6571865489277, 665.873484038036, 668.3183153183774, 14338.42646294147, 14367.784483232655, 14454.927725361305, 14573.854261457356, 14582.781258281135, 14286.642833929234, 14300.785488217685, 14373.209473478955, 14532.346044428026, 14713.411463541446, 11377.88622113785, 11773.941130294379, 11899.881001189964, 11949.880501194964, 12232.0, 3067.3098552825436, 3843.7501562398356, 3860.864869729574, 3864.8840534784003, 3879.709021823346, 94820.0, 98438.0, 121003.0, 121444.39277803554, 121667.391663042, 10716.249862509705, 10958.452077396098, 11006.944965275123, 11333.659990200307, 11451.198416110792, 20048.69926951097, 20942.95285235732, 21051.8947405262, 21374.572508549743, 21672.56654866894, 8250.587470626444, 8356.432293092204, 8404.411691181558, 8487.830243395098, 8576.957115214384, 4579.748113853703, 4622.67641265115, 4639.768011599406, 4696.530346965276, 4761.071591039783, 3557.2351944332095, 3683.9263214735556, 3690.114372550622, 3692.1508053147927, 3692.1692619160476, 655.8588056781261, 656.6454114778062, 667.2993356975156, 684.7432212920155, 686.2348481443155, 567.3730527766841, 642.4860111910453, 661.1075048684334, 667.2693400726197, 668.7358493395179, 6985.476089293324, 7943.920560794434, 9148.085191480799, 9254.259659227246, 9273.0, 586.4575267877196, 619.294004834489, 660.3660485933461, 665.5374514712229, 671.5903298987614, 4409.603135717801, 4643.95356046442, 4650.0, 4689.50760170184, 4727.317860245749, 130219.0, 155311.0, 159088.0, 167887.0, 172580.0, 80246.5987670058, 80975.0, 83471.0, 133458.66541334463, 134318.0, 57461.99999999916, 73500.63249683718, 98639.52040719395, 113625.0, 116981.0, 9671.177949874058, 9885.950570247103, 9942.652007179713, 10064.293025150924, 10167.542460589144, 51083.74458127686, 54747.45252547583, 62474.37525624686, 63236.0, 65621.34378656153, 73025.0, 94151.0, 94525.0, 96238.0, 97796.0, 10387.792244154924, 12484.0, 12559.309237991998, 12963.41664625113, 13270.336483175995, 14564.053336533092, 14598.489052883098, 14666.266686665838, 14701.338439770023, 15217.0, 12493.375331233221, 13622.659433514242, 13936.163830170222, 14023.368948397143, 14459.060161089496, 11554.480048397674, 13521.86478135206, 14310.28448577546, 14430.278486075864, 14490.782638260223, 13261.80107298372, 13377.264250466318, 13634.1137826041, 14017.369218384993, 14081.718365632425, 10813.656114214773, 10935.48741400475, 11409.60066397672, 11762.117841161777, 11901.401778278683, 9612.471314077793, 10733.892661073289, 11454.885451145381, 11569.537218511165, 11800.468978896142], "value": 7728.42701995386, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1551.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 126.0, 118.0, 116.0, 115.0, 121.0, 122.0, 119.0, 116.0, 118.0], "value": 116.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 111.0, 110.0, 146.0, 113.0, 111.0, 114.0, 112.0, 137.0, 112.0], "value": 121.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [196.0, 202.0, 194.0, 230.0, 283.0, 201.0, 197.0, 197.0, 198.0, 196.0], "value": 209.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 59.0, 59.0, 86.0, 61.0, 59.0, 63.0, 81.0, 108.0, 49.0], "value": 70.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 70.0, 92.0, 75.0, 100.0, 103.0, 125.0, 76.0, 69.0, 88.0], "value": 88.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 123.0, 90.0, 74.0, 93.0, 88.0, 92.0, 90.0, 91.0, 88.0], "value": 96.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 124.0, 124.0, 97.0, 96.0, 96.0, 98.0, 97.0, 97.0, 99.0], "value": 102.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 101.0, 99.0, 149.0, 93.0, 95.0, 122.0, 151.0, 77.0, 143.0], "value": 112.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 54.0, 56.0, 56.0, 59.0, 59.0, 61.0, 59.0, 60.0, 60.0], "value": 57.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 71.0, 69.0, 87.0, 94.0, 69.0, 68.0, 70.0, 72.0, 73.0], "value": 74.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 83.0, 84.0, 83.0, 83.0, 87.0, 83.0, 87.0, 88.0, 90.0], "value": 85.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 156.0, 146.0, 138.0, 137.0, 138.0, 134.0, 155.0, 189.0, 144.0], "value": 148.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [186.0, 154.0, 190.0, 154.0, 216.0, 151.0, 170.0, 204.0, 227.0, 203.0], "value": 185.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 79.0, 89.0, 87.0, 88.0, 88.0, 93.0, 73.0, 85.0, 59.0], "value": 81.0, "unit": "score"}]}]} 05:33:03 INFO - Return code: 0 05:33:03 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:33:03 ERROR - # TBPL SUCCESS # 05:33:03 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:33:03 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:33:03 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:33:03 INFO - 2016-09-20 05:33:03.528 screenresolution[1960:19844] starting screenresolution argv=screenresolution get 05:33:03 INFO - 2016-09-20 05:33:03.530 screenresolution[1960:19844] Display 0: 1600x1200x32@60 05:33:03 INFO - 2016-09-20 05:33:03.536 screenresolution[1961:19847] starting screenresolution argv=screenresolution list 05:33:03 INFO - Available Modes on Display 0 05:33:03 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:33:03 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:33:03 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:33:03 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:33:03 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:33:03 INFO - Intel Iris: 05:33:03 INFO - Chipset Model: Intel Iris 05:33:03 INFO - Type: GPU 05:33:03 INFO - Bus: Built-In 05:33:03 INFO - VRAM (Dynamic, Max): 1536 MB 05:33:03 INFO - Vendor: Intel (0x8086) 05:33:03 INFO - Device ID: 0x0a2e 05:33:03 INFO - Revision ID: 0x0009 05:33:03 INFO - Displays: 05:33:03 INFO - Display: 05:33:03 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:33:03 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:33:03 INFO - Display Serial Number: 1600x1200 60 05:33:03 INFO - Main Display: Yes 05:33:03 INFO - Mirror: Off 05:33:03 INFO - Online: Yes 05:33:03 INFO - Rotation: Supported 05:33:03 INFO - Return code: 0 05:33:03 INFO - Running post-action listener: _resource_record_post_action 05:33:03 INFO - [mozharness: 2016-09-20 12:33:03.777095Z] Finished run-tests step (success) 05:33:03 INFO - Running post-run listener: _resource_record_post_run 05:33:03 INFO - Total resource usage - Wall time: 1208s; CPU: 55.0%; Read bytes: 811008; Write bytes: 663467008; Read time: 9; Write time: 1926 05:33:03 INFO - TinderboxPrint: CPU usage
54.5% 05:33:03 INFO - TinderboxPrint: I/O read bytes / time
811,008 / 9 05:33:03 INFO - TinderboxPrint: I/O write bytes / time
663,467,008 / 1,926 05:33:03 INFO - TinderboxPrint: CPU idle
2,198.9 (45.5%) 05:33:03 INFO - TinderboxPrint: CPU system
984.3 (20.4%) 05:33:03 INFO - TinderboxPrint: CPU user
1,650.6 (34.1%) 05:33:03 INFO - TinderboxPrint: Swap in / out
363,241,472 / 0 05:33:03 INFO - install - Wall time: 33s; CPU: 55.0%; Read bytes: 353812992; Write bytes: 356640256; Read time: 27518; Write time: 750 05:33:03 INFO - run-tests - Wall time: 1176s; CPU: 55.0%; Read bytes: 811008; Write bytes: 296648192; Read time: 9; Write time: 1143 05:33:04 INFO - Running post-run listener: _upload_blobber_files 05:33:04 INFO - Blob upload gear active. 05:33:04 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:33:04 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 05:33:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:33:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:33:04 INFO - (blobuploader) - INFO - Open directory for files ... 05:33:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:33:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:33:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:33:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:33:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:33:05 INFO - (blobuploader) - INFO - Done attempting. 05:33:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 05:33:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:33:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:33:06 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 05:33:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:33:06 INFO - (blobuploader) - INFO - Done attempting. 05:33:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:33:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:33:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:33:08 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:33:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:33:08 INFO - (blobuploader) - INFO - Done attempting. 05:33:08 INFO - (blobuploader) - INFO - Iteration through files over. 05:33:08 INFO - Return code: 0 05:33:08 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:33:08 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:33:08 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ad2a7f6ab1ab7082ce4660cb31194fca5886be61811f1862b8f9d9a1c75e7ed5cee86060d50db2b80272149fc7c4fac253fc16f974487d5eb20d84a4a7670845", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5b2baf933e0e68702e57371359fd981c7eec1094a18409c84c4fe319f164c2f8306cb238de9445eaf825894c13f345fd7cbcb1a3ff295ce04838726ff7c4f463", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/21e4e8c32560564eec57280e14eed601d7a6a9644cf9d8241cdb0bcb4f65cf10b8a200233ee495d2b4cd7f3ceb8d651c82f3a75e8ca7bc66719732ec79c316dc"} 05:33:08 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:33:08 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:33:08 INFO - Contents: 05:33:08 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ad2a7f6ab1ab7082ce4660cb31194fca5886be61811f1862b8f9d9a1c75e7ed5cee86060d50db2b80272149fc7c4fac253fc16f974487d5eb20d84a4a7670845", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5b2baf933e0e68702e57371359fd981c7eec1094a18409c84c4fe319f164c2f8306cb238de9445eaf825894c13f345fd7cbcb1a3ff295ce04838726ff7c4f463", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/21e4e8c32560564eec57280e14eed601d7a6a9644cf9d8241cdb0bcb4f65cf10b8a200233ee495d2b4cd7f3ceb8d651c82f3a75e8ca7bc66719732ec79c316dc"} 05:33:08 INFO - Running post-run listener: copy_logs_to_upload_dir 05:33:08 INFO - Copying logs to upload dir... 05:33:08 INFO - mkdir: /builds/slave/test/build/upload/logs 05:33:08 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1267.647772 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-09-20 05:33:08.858043) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-20 05:33:08.861334) ========= 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.CRxGOy3xMT/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.TKW6dCTulb/Listeners TMPDIR=/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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-Aurora/sha512/ad2a7f6ab1ab7082ce4660cb31194fca5886be61811f1862b8f9d9a1c75e7ed5cee86060d50db2b80272149fc7c4fac253fc16f974487d5eb20d84a4a7670845", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5b2baf933e0e68702e57371359fd981c7eec1094a18409c84c4fe319f164c2f8306cb238de9445eaf825894c13f345fd7cbcb1a3ff295ce04838726ff7c4f463", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/21e4e8c32560564eec57280e14eed601d7a6a9644cf9d8241cdb0bcb4f65cf10b8a200233ee495d2b4cd7f3ceb8d651c82f3a75e8ca7bc66719732ec79c316dc"} build_url:https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011032 build_url: 'https://queue.taskcluster.net/v1/task/eL5_igh4Sc6GVCBNsmV4EQ/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ad2a7f6ab1ab7082ce4660cb31194fca5886be61811f1862b8f9d9a1c75e7ed5cee86060d50db2b80272149fc7c4fac253fc16f974487d5eb20d84a4a7670845", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5b2baf933e0e68702e57371359fd981c7eec1094a18409c84c4fe319f164c2f8306cb238de9445eaf825894c13f345fd7cbcb1a3ff295ce04838726ff7c4f463", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/21e4e8c32560564eec57280e14eed601d7a6a9644cf9d8241cdb0bcb4f65cf10b8a200233ee495d2b4cd7f3ceb8d651c82f3a75e8ca7bc66719732ec79c316dc"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-20 05:33:08.894352) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:33:08.894658) ========= 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.CRxGOy3xMT/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.TKW6dCTulb/Listeners TMPDIR=/var/folders/jg/x01k5sqn6dx7sgpxmxkndj5h00000w/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.005250 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:33:08.942743) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-20 05:33:08.943066) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-20 05:33:08.943383) ========= ========= Total master_lag: 0.19 =========