builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0251 starttime: 1473288549.92 results: success (0) buildid: 20160907145315 builduid: 096e552e9c28401dac78a3ae63c19cc0 revision: a1e635fc39e261b45e5799809a051b6b51a10f59 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:09.918065) ========= master: http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:09.918504) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:09.918779) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:09.971121) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:09.971397) ========= 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.AQbPoEoF21/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.xueSlZnyuT/Listeners TMPDIR=/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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-07 15:49:09-- 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% 19.1M=0.001s 2016-09-07 15:49:10 (19.1 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.650043 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:10.643622) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:10.643901) ========= 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.AQbPoEoF21/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.xueSlZnyuT/Listeners TMPDIR=/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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.024806 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:10.691919) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-07 15:49:10.692305) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev a1e635fc39e261b45e5799809a051b6b51a10f59 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev a1e635fc39e261b45e5799809a051b6b51a10f59 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.AQbPoEoF21/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.xueSlZnyuT/Listeners TMPDIR=/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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-07 15:49:10,756 truncating revision to first 12 chars 2016-09-07 15:49:10,756 Setting DEBUG logging. 2016-09-07 15:49:10,756 attempt 1/10 2016-09-07 15:49:10,756 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/a1e635fc39e2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-07 15:49:11,814 unpacking tar archive at: fx-team-a1e635fc39e2/testing/mozharness/ program finished with exit code 0 elapsedTime=1.325882 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-07 15:49:12.040251) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:12.040552) ========= script_repo_revision: a1e635fc39e261b45e5799809a051b6b51a10f59 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:12.040924) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:12.041185) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-07 15:49:12.059927) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 15 secs) (at 2016-09-07 15:49:12.060268) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.AQbPoEoF21/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.xueSlZnyuT/Listeners TMPDIR=/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:49:12 INFO - MultiFileLogger online at 20160907 15:49:12 in /builds/slave/test 15:49:12 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 15:49:12 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:49:12 INFO - {'append_to_log': False, 15:49:12 INFO - 'base_work_dir': '/builds/slave/test', 15:49:12 INFO - 'blob_upload_branch': 'Fx-Team', 15:49:12 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:49:12 INFO - 'branch': 'Fx-Team', 15:49:12 INFO - 'buildbot_json_path': 'buildprops.json', 15:49:12 INFO - 'config_files': ('talos/mac_config.py',), 15:49:12 INFO - 'default_actions': ('clobber', 15:49:12 INFO - 'read-buildbot-config', 15:49:12 INFO - 'download-and-extract', 15:49:12 INFO - 'populate-webroot', 15:49:12 INFO - 'create-virtualenv', 15:49:12 INFO - 'install', 15:49:12 INFO - 'run-tests'), 15:49:12 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:49:12 INFO - 'download_minidump_stackwalk': True, 15:49:12 INFO - 'download_symbols': 'ondemand', 15:49:12 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:49:12 INFO - 'tooltool.py': '/tools/tooltool.py', 15:49:12 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:49:12 INFO - '/tools/misc-python/virtualenv.py')}, 15:49:12 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:49:12 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:49:12 INFO - 'installer_path': 'installer.exe', 15:49:12 INFO - 'log_level': 'info', 15:49:12 INFO - 'log_name': 'talos', 15:49:12 INFO - 'log_to_console': True, 15:49:12 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 15:49:12 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 15:49:12 INFO - 'opt_config_files': (), 15:49:12 INFO - 'pip_index': False, 15:49:12 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:49:12 INFO - 'cmd': ('bash', 15:49:12 INFO - '-c', 15:49:12 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:49:12 INFO - 'enabled': True, 15:49:12 INFO - 'halt_on_failure': False, 15:49:12 INFO - 'name': 'check_screen_resolution'},), 15:49:12 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:49:12 INFO - 'cmd': ('bash', 15:49:12 INFO - '-c', 15:49:12 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:49:12 INFO - 'enabled': True, 15:49:12 INFO - 'halt_on_failure': False, 15:49:12 INFO - 'name': 'check_screen_resolution'},), 15:49:12 INFO - 'run_cmd_checks_enabled': True, 15:49:12 INFO - 'sps_profile': False, 15:49:12 INFO - 'sps_profile_interval': 0, 15:49:12 INFO - 'suite': 'dromaeojs', 15:49:12 INFO - 'system_bits': '32', 15:49:12 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:49:12 INFO - 'title': 't-yosemite-r7-0251', 15:49:12 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:49:12 INFO - 'use_talos_json': True, 15:49:12 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:49:12 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:49:12 INFO - 'work_dir': 'build'} 15:49:12 INFO - [mozharness: 2016-09-07 22:49:12.233894Z] Running clobber step. 15:49:12 INFO - Running pre-action listener: _resource_record_pre_action 15:49:12 INFO - Running main action method: clobber 15:49:12 INFO - rmtree: /builds/slave/test/build 15:49:12 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:49:14 INFO - Running post-action listener: _resource_record_post_action 15:49:14 INFO - [mozharness: 2016-09-07 22:49:14.278448Z] Finished clobber step (success) 15:49:14 INFO - [mozharness: 2016-09-07 22:49:14.278526Z] Running read-buildbot-config step. 15:49:14 INFO - Running pre-action listener: _resource_record_pre_action 15:49:14 INFO - Running main action method: read_buildbot_config 15:49:14 INFO - Using buildbot properties: 15:49:14 INFO - { 15:49:14 INFO - "project": "", 15:49:14 INFO - "product": "firefox", 15:49:14 INFO - "script_repo_revision": "production", 15:49:14 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 15:49:14 INFO - "repository": "", 15:49:14 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 15:49:14 INFO - "buildid": "20160907145315", 15:49:14 INFO - "pgo_build": "False", 15:49:14 INFO - "basedir": "/builds/slave/test", 15:49:14 INFO - "buildnumber": 109, 15:49:14 INFO - "slavename": "t-yosemite-r7-0251", 15:49:14 INFO - "master": "http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/", 15:49:14 INFO - "platform": "yosemite_r7", 15:49:14 INFO - "scheduler": "tests-fx-team-macosx64-talos", 15:49:14 INFO - "branch": "fx-team", 15:49:14 INFO - "repo_path": "integration/fx-team", 15:49:14 INFO - "revision": "a1e635fc39e261b45e5799809a051b6b51a10f59", 15:49:14 INFO - "stage_platform": "macosx64", 15:49:14 INFO - "builduid": "096e552e9c28401dac78a3ae63c19cc0", 15:49:14 INFO - "slavebuilddir": "test" 15:49:14 INFO - } 15:49:14 INFO - Found installer url https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg. 15:49:14 INFO - Running post-action listener: _resource_record_post_action 15:49:14 INFO - [mozharness: 2016-09-07 22:49:14.281741Z] Finished read-buildbot-config step (success) 15:49:14 INFO - [mozharness: 2016-09-07 22:49:14.281826Z] Running download-and-extract step. 15:49:14 INFO - Running pre-action listener: _resource_record_pre_action 15:49:14 INFO - Running main action method: download_and_extract 15:49:14 INFO - mkdir: /builds/slave/test/build/tests 15:49:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:49:14 INFO - trying https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json 15:49:14 INFO - Downloading https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 15:49:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json'}, attempt #1 15:49:15 INFO - Downloaded 1199 bytes. 15:49:15 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 15:49:15 INFO - Using the following test package requirements: 15:49:15 INFO - {u'common': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 15:49:15 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:49:15 INFO - u'firefox-51.0a1.en-US.mac.cppunittest.tests.zip'], 15:49:15 INFO - u'gtest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:49:15 INFO - u'firefox-51.0a1.en-US.mac.gtest.tests.zip'], 15:49:15 INFO - u'jittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:49:15 INFO - u'jsshell-mac.zip'], 15:49:15 INFO - u'mochitest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:49:15 INFO - u'firefox-51.0a1.en-US.mac.mochitest.tests.zip'], 15:49:15 INFO - u'mozbase': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 15:49:15 INFO - u'reftest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:49:15 INFO - u'firefox-51.0a1.en-US.mac.reftest.tests.zip'], 15:49:15 INFO - u'talos': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:49:15 INFO - u'firefox-51.0a1.en-US.mac.talos.tests.zip'], 15:49:15 INFO - u'web-platform': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:49:15 INFO - u'firefox-51.0a1.en-US.mac.web-platform.tests.zip'], 15:49:15 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:49:15 INFO - u'firefox-51.0a1.en-US.mac.xpcshell.tests.zip']} 15:49:15 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip'] for test suite category: common 15:49:16 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 15:49:16 INFO - retry: Calling unzip with args: (), kwargs: {'file_object': >, 'verbose': False, 'extract_dirs': '*', 'extract_to': '/builds/slave/test/build/tests'}, attempt #1 15:49:23 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip', u'firefox-51.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 15:49:23 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 15:49:23 INFO - retry: Calling unzip with args: (), kwargs: {'file_object': >, 'verbose': False, 'extract_dirs': '*', 'extract_to': '/builds/slave/test/build/tests'}, attempt #1 15:49:31 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip 15:49:31 INFO - retry: Calling unzip with args: (), kwargs: {'file_object': >, 'verbose': False, 'extract_dirs': '*', 'extract_to': '/builds/slave/test/build/tests'}, attempt #1 15:49:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:49:32 INFO - trying https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 15:49:32 INFO - Downloading https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg 15:49:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg'}, attempt #1 15:50:01 WARNING - URL Error: https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 15:50:01 INFO - Running command: ['nslookup', 'queue.taskcluster.net'] 15:50:01 INFO - Copy/paste: nslookup queue.taskcluster.net 15:50:01 INFO - Server: 10.26.75.40 15:50:01 INFO - Address: 10.26.75.40#53 15:50:01 INFO - queue.taskcluster.net canonical name = toyama-73636.herokussl.com. 15:50:01 INFO - toyama-73636.herokussl.com canonical name = elb081832-1105536650.us-east-1.elb.amazonaws.com. 15:50:01 INFO - Name: elb081832-1105536650.us-east-1.elb.amazonaws.com 15:50:01 INFO - Address: 107.21.253.109 15:50:01 INFO - Name: elb081832-1105536650.us-east-1.elb.amazonaws.com 15:50:01 INFO - Address: 54.225.205.67 15:50:01 INFO - Name: elb081832-1105536650.us-east-1.elb.amazonaws.com 15:50:01 INFO - Address: 54.204.30.40 15:50:01 INFO - Return code: 0 15:50:01 INFO - retry: attempt #1 caught exception: 15:50:01 INFO - retry: Failed, sleeping 30 seconds before retrying 15:50:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg'}, attempt #2 15:50:35 INFO - Downloaded 111551766 bytes. 15:50:35 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 15:50:35 INFO - mkdir: /builds/slave/test/properties 15:50:35 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:50:35 INFO - Writing to file /builds/slave/test/properties/build_url 15:50:35 INFO - Contents: 15:50:35 INFO - build_url:https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 15:50:35 INFO - Running post-action listener: _resource_record_post_action 15:50:35 INFO - Running post-action listener: set_extra_try_arguments 15:50:35 INFO - [mozharness: 2016-09-07 22:50:35.954699Z] Finished download-and-extract step (success) 15:50:35 INFO - [mozharness: 2016-09-07 22:50:35.954852Z] Running populate-webroot step. 15:50:35 INFO - Running pre-action listener: _resource_record_pre_action 15:50:35 INFO - Running main action method: populate_webroot 15:50:35 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:50:35 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:50:35 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:50:35 INFO - '--tppagecycles', 15:50:35 INFO - '7'], 15:50:35 INFO - 'tests': ['tsvgm']}}, 15:50:35 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:50:35 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 15:50:35 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['dromaeo_css', 'kraken']}, 15:50:35 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 15:50:35 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:50:35 INFO - 'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:50:35 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:50:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:50:35 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:50:35 INFO - 'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['damp', 'tps']}, 15:50:35 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:50:35 INFO - 'tests': ['damp', 'tps']}, 15:50:35 INFO - 'g3': {'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['dromaeo_dom']}, 15:50:35 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:50:35 INFO - 'g4': {'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['basic_compositor_video']}, 15:50:35 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 15:50:35 INFO - 'other': {'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['a11yr', 15:50:35 INFO - 'ts_paint', 15:50:35 INFO - 'tpaint', 15:50:35 INFO - 'sessionrestore', 15:50:35 INFO - 'sessionrestore_no_auto_restore', 15:50:35 INFO - 'tabpaint']}, 15:50:35 INFO - 'other-e10s': {'tests': ['a11yr', 15:50:35 INFO - 'ts_paint', 15:50:35 INFO - 'tpaint', 15:50:35 INFO - 'sessionrestore', 15:50:35 INFO - 'sessionrestore_no_auto_restore', 15:50:35 INFO - 'tabpaint']}, 15:50:35 INFO - 'other-e10s_l64': {'tests': ['a11yr', 15:50:35 INFO - 'ts_paint', 15:50:35 INFO - 'tpaint', 15:50:35 INFO - 'sessionrestore', 15:50:35 INFO - 'sessionrestore_no_auto_restore', 15:50:35 INFO - 'tabpaint']}, 15:50:35 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 15:50:35 INFO - 'ts_paint', 15:50:35 INFO - 'tpaint', 15:50:35 INFO - 'sessionrestore', 15:50:35 INFO - 'sessionrestore_no_auto_restore', 15:50:35 INFO - 'tabpaint']}, 15:50:35 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['a11yr', 15:50:35 INFO - 'ts_paint', 15:50:35 INFO - 'tpaint', 15:50:35 INFO - 'sessionrestore', 15:50:35 INFO - 'sessionrestore_no_auto_restore', 15:50:35 INFO - 'tabpaint']}, 15:50:35 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['a11yr', 15:50:35 INFO - 'ts_paint', 15:50:35 INFO - 'tpaint', 15:50:35 INFO - 'sessionrestore', 15:50:35 INFO - 'sessionrestore_no_auto_restore', 15:50:35 INFO - 'tabpaint']}, 15:50:35 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['tsvgx', 15:50:35 INFO - 'tsvgr_opacity', 15:50:35 INFO - 'tart', 15:50:35 INFO - 'tscrollx', 15:50:35 INFO - 'cart']}, 15:50:35 INFO - 'svgr-e10s': {'tests': ['tsvgx', 15:50:35 INFO - 'tsvgr_opacity', 15:50:35 INFO - 'tart', 15:50:35 INFO - 'tscrollx', 15:50:35 INFO - 'cart']}, 15:50:35 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:50:35 INFO - 'talos_options': ['--disable-e10s'], 15:50:35 INFO - 'tests': ['tp5o']}, 15:50:35 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:50:35 INFO - 'tests': ['tp5o']}, 15:50:35 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:50:35 INFO - 'talos_options': ['--disable-e10s', 15:50:35 INFO - '--xperf_path', 15:50:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:50:35 INFO - 'tests': ['tp5n']}, 15:50:35 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:50:35 INFO - 'talos_options': ['--xperf_path', 15:50:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:50:35 INFO - 'tests': ['tp5n']}}, 15:50:35 INFO - 'talos.zip': {'path': '', 15:50:35 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:50:35 INFO - Running post-action listener: _resource_record_post_action 15:50:35 INFO - [mozharness: 2016-09-07 22:50:35.974505Z] Finished populate-webroot step (success) 15:50:35 INFO - [mozharness: 2016-09-07 22:50:35.974638Z] Running create-virtualenv step. 15:50:35 INFO - Running pre-action listener: _resource_record_pre_action 15:50:35 INFO - Running main action method: create_virtualenv 15:50:35 INFO - Creating virtualenv /builds/slave/test/build/venv 15:50:35 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 15:50:35 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:50:36 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:50:36 INFO - Using real prefix '/tools/python27' 15:50:36 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:50:36 INFO - Installing distribute.............................................................................................................................................................................................done. 15:50:39 INFO - Installing pip.................done. 15:50:39 INFO - Return code: 0 15:50:39 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:50: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')]} 15:50:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:50:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50: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')]} 15:50:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:50:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:50: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', 'pip>=1.5'] in /builds/slave/test/build 15:50: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 pip>=1.5 15:50:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:50:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:50:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:50:39 INFO - 'HOME': '/Users/cltbld', 15:50:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:50:39 INFO - 'LOGNAME': 'cltbld', 15:50:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:50:39 INFO - 'MOZ_NO_REMOTE': '1', 15:50:39 INFO - 'NO_EM_RESTART': '1', 15:50:39 INFO - 'PAGER': '/bin/cat', 15:50:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:50:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:50:39 INFO - 'PWD': '/builds/slave/test', 15:50:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:50:39 INFO - 'SHELL': '/bin/bash', 15:50:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:50:39 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:50:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:50:39 INFO - 'USER': 'cltbld', 15:50:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:50:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:50:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:50:39 INFO - 'XPC_FLAGS': '0x0', 15:50:39 INFO - 'XPC_SERVICE_NAME': '0', 15:50:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:50:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:50:39 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 15:50:39 INFO - Cleaning up... 15:50:39 INFO - Return code: 0 15:50:39 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 15:50: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')]} 15:50:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:50:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50: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')]} 15:50:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:50:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50: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', '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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:50: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', 'psutil>=3.1.1'] in /builds/slave/test/build 15:50: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 psutil>=3.1.1 15:50:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:50:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:50:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:50:39 INFO - 'HOME': '/Users/cltbld', 15:50:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:50:39 INFO - 'LOGNAME': 'cltbld', 15:50:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:50:39 INFO - 'MOZ_NO_REMOTE': '1', 15:50:39 INFO - 'NO_EM_RESTART': '1', 15:50:39 INFO - 'PAGER': '/bin/cat', 15:50:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:50:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:50:39 INFO - 'PWD': '/builds/slave/test', 15:50:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:50:39 INFO - 'SHELL': '/bin/bash', 15:50:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:50:39 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:50:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:50:39 INFO - 'USER': 'cltbld', 15:50:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:50:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:50:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:50:39 INFO - 'XPC_FLAGS': '0x0', 15:50:39 INFO - 'XPC_SERVICE_NAME': '0', 15:50:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:50:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:50:40 INFO - Downloading/unpacking psutil>=3.1.1 15:50: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 15:50: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 15:50: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 15:50: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 15:50: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 15:50: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 15:50:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:50:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:50:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:50:43 INFO - Installing collected packages: psutil 15:50:43 INFO - Running setup.py install for psutil 15:50:43 INFO - building 'psutil._psutil_osx' extension 15:50:43 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 15:50:44 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 15:50:44 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 15:50:44 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 15:50:44 INFO - building 'psutil._psutil_posix' extension 15:50:44 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 15:50:44 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 15:50:44 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 15:50:44 INFO - ^ 15:50:44 INFO - 1 warning generated. 15:50:44 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 15:50:44 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:50:44 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:50:44 INFO - Successfully installed psutil 15:50:44 INFO - Cleaning up... 15:50:45 INFO - Return code: 0 15:50:45 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 15:50:45 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')]} 15:50:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:50:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:45 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')]} 15:50:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:50:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:45 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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:50:45 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 15:50:45 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 15:50:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:50:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:50:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:50:45 INFO - 'HOME': '/Users/cltbld', 15:50:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:50:45 INFO - 'LOGNAME': 'cltbld', 15:50:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:50:45 INFO - 'MOZ_NO_REMOTE': '1', 15:50:45 INFO - 'NO_EM_RESTART': '1', 15:50:45 INFO - 'PAGER': '/bin/cat', 15:50:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:50:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:50:45 INFO - 'PWD': '/builds/slave/test', 15:50:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:50:45 INFO - 'SHELL': '/bin/bash', 15:50:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:50:45 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:50:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:50:45 INFO - 'USER': 'cltbld', 15:50:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:50:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:50:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:50:45 INFO - 'XPC_FLAGS': '0x0', 15:50:45 INFO - 'XPC_SERVICE_NAME': '0', 15:50:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:50:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:50:45 INFO - Downloading/unpacking mozsystemmonitor==0.3 15:50:45 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 15:50:45 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 15:50:45 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 15:50:45 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 15:50:45 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 15:50:45 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 15:50:47 INFO - Downloading mozsystemmonitor-0.3.tar.gz 15:50:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:50:47 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 15:50:47 INFO - Installing collected packages: mozsystemmonitor 15:50:47 INFO - Running setup.py install for mozsystemmonitor 15:50:48 INFO - Successfully installed mozsystemmonitor 15:50:48 INFO - Cleaning up... 15:50:48 INFO - Return code: 0 15:50:48 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 15:50:48 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')]} 15:50:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:50:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:48 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')]} 15:50:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:50:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:48 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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:50:48 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 15:50:48 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 15:50:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:50:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:50:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:50:48 INFO - 'HOME': '/Users/cltbld', 15:50:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:50:48 INFO - 'LOGNAME': 'cltbld', 15:50:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:50:48 INFO - 'MOZ_NO_REMOTE': '1', 15:50:48 INFO - 'NO_EM_RESTART': '1', 15:50:48 INFO - 'PAGER': '/bin/cat', 15:50:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:50:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:50:48 INFO - 'PWD': '/builds/slave/test', 15:50:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:50:48 INFO - 'SHELL': '/bin/bash', 15:50:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:50:48 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:50:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:50:48 INFO - 'USER': 'cltbld', 15:50:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:50:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:50:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:50:48 INFO - 'XPC_FLAGS': '0x0', 15:50:48 INFO - 'XPC_SERVICE_NAME': '0', 15:50:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:50:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:50:48 INFO - Downloading/unpacking jsonschema==2.5.1 15:50:48 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 15:50:48 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 15:50:48 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 15:50:48 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 15:50:48 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 15:50:48 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 15:50:50 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:50:50 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 15:50:50 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 15:50:50 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 15:50:50 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 15:50:50 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 15:50:50 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 15:50:50 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 15:50:51 INFO - Downloading functools32-3.2.3-2.tar.gz 15:50:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:50:51 INFO - warning: no files found matching '*.txt' 15:50:51 INFO - no previously-included directories found matching 'build' 15:50:51 INFO - no previously-included directories found matching 'dist' 15:50:51 INFO - no previously-included directories found matching '.git*' 15:50:51 INFO - Installing collected packages: jsonschema, functools32 15:50:51 INFO - Running setup.py install for functools32 15:50:51 INFO - warning: no files found matching '*.txt' 15:50:51 INFO - no previously-included directories found matching 'build' 15:50:51 INFO - no previously-included directories found matching 'dist' 15:50:51 INFO - no previously-included directories found matching '.git*' 15:50:51 INFO - Successfully installed jsonschema functools32 15:50:51 INFO - Cleaning up... 15:50:51 INFO - Return code: 0 15:50:51 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 15:50:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:50:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:50:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:50:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:50:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:50:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 15:50:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 15:50:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:50:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:50:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:50:51 INFO - 'HOME': '/Users/cltbld', 15:50:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:50:51 INFO - 'LOGNAME': 'cltbld', 15:50:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:50:51 INFO - 'MOZ_NO_REMOTE': '1', 15:50:51 INFO - 'NO_EM_RESTART': '1', 15:50:51 INFO - 'PAGER': '/bin/cat', 15:50:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:50:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:50:51 INFO - 'PWD': '/builds/slave/test', 15:50:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:50:51 INFO - 'SHELL': '/bin/bash', 15:50:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:50:51 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:50:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:50:51 INFO - 'USER': 'cltbld', 15:50:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:50:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:50:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:50:51 INFO - 'XPC_FLAGS': '0x0', 15:50:51 INFO - 'XPC_SERVICE_NAME': '0', 15:50:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:50:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:50:51 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 15:50:51 INFO - Cleaning up... 15:50:51 INFO - Return code: 0 15:50:51 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:50:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:50:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:50:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:50:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:50:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:50:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 15:50:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 15:50:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:50:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:50:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:50:51 INFO - 'HOME': '/Users/cltbld', 15:50:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:50:51 INFO - 'LOGNAME': 'cltbld', 15:50:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:50:51 INFO - 'MOZ_NO_REMOTE': '1', 15:50:51 INFO - 'NO_EM_RESTART': '1', 15:50:51 INFO - 'PAGER': '/bin/cat', 15:50:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:50:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:50:51 INFO - 'PWD': '/builds/slave/test', 15:50:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:50:51 INFO - 'SHELL': '/bin/bash', 15:50:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:50:51 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:50:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:50:51 INFO - 'USER': 'cltbld', 15:50:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:50:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:50:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:50:51 INFO - 'XPC_FLAGS': '0x0', 15:50:51 INFO - 'XPC_SERVICE_NAME': '0', 15:50:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:50:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:50:52 INFO - Downloading/unpacking blobuploader==1.2.4 15:50:52 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 15:50:52 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 15:50:52 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 15:50:52 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 15:50:52 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 15:50:52 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 15:50:54 INFO - Downloading blobuploader-1.2.4.tar.gz 15:50:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:50:54 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:50:54 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 15:50:54 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 15:50:54 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 15:50:54 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 15:50:54 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 15:50:54 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 15:50:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:50:55 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:50:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:50:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:50:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:50:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:50:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:50:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:50:55 INFO - Downloading docopt-0.6.1.tar.gz 15:50:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:50:55 INFO - Installing collected packages: blobuploader, requests, docopt 15:50:55 INFO - Running setup.py install for blobuploader 15:50:56 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:50:56 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:50:56 INFO - Running setup.py install for requests 15:50:56 INFO - Running setup.py install for docopt 15:50:56 INFO - Successfully installed blobuploader requests docopt 15:50:56 INFO - Cleaning up... 15:50:56 INFO - Return code: 0 15:50:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:50:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:50:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:50:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:50:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:50:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:50:56 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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:50:56 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 15:50:56 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 15:50:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:50:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:50:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:50:56 INFO - 'HOME': '/Users/cltbld', 15:50:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:50:56 INFO - 'LOGNAME': 'cltbld', 15:50:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:50:56 INFO - 'MOZ_NO_REMOTE': '1', 15:50:56 INFO - 'NO_EM_RESTART': '1', 15:50:56 INFO - 'PAGER': '/bin/cat', 15:50:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:50:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:50:56 INFO - 'PWD': '/builds/slave/test', 15:50:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:50:56 INFO - 'SHELL': '/bin/bash', 15:50:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:50:56 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:50:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:50:56 INFO - 'USER': 'cltbld', 15:50:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:50:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:50:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:50:56 INFO - 'XPC_FLAGS': '0x0', 15:50:56 INFO - 'XPC_SERVICE_NAME': '0', 15:50:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:50:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-09MmP7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-3VxKOL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-G05oS0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-RAVbhY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-VXKkR8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-A0bdK2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-dfNO8n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-1h9pA2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:50:57 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-rWLogs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:50:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:50:58 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-o7dItV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:50:58 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-kSTb6u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:50:58 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-nUn9fd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:50:58 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-8F_Mb1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:50:58 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-AbtPdV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:50:58 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-dpMEZt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:50:58 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-ON0H4v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:50:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:50:58 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-iwt59o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:50:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:50:58 INFO - Running setup.py install for manifestparser 15:50:58 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:50:58 INFO - Running setup.py install for mozcrash 15:50:59 INFO - Running setup.py install for mozdebug 15:50:59 INFO - Running setup.py install for mozdevice 15:50:59 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:50:59 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:50:59 INFO - Running setup.py install for mozfile 15:50:59 INFO - Running setup.py install for mozhttpd 15:50:59 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:50:59 INFO - Running setup.py install for mozinfo 15:50:59 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:50:59 INFO - Running setup.py install for mozInstall 15:50:59 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:50:59 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:50:59 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:50:59 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:51:00 INFO - Running setup.py install for mozleak 15:51:00 INFO - Running setup.py install for mozlog 15:51:00 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:51:00 INFO - Running setup.py install for moznetwork 15:51:00 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:51:00 INFO - Running setup.py install for mozprocess 15:51:00 INFO - Running setup.py install for mozprofile 15:51:00 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:51:00 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:51:00 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:51:00 INFO - Running setup.py install for mozrunner 15:51:00 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:51:00 INFO - Running setup.py install for mozscreenshot 15:51:01 INFO - Running setup.py install for moztest 15:51:01 INFO - Running setup.py install for mozversion 15:51:01 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:51:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:51:01 INFO - Cleaning up... 15:51:01 INFO - Return code: 0 15:51:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:51:01 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')]} 15:51:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:01 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')]} 15:51:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:01 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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:51:01 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 15:51:01 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 15:51:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:51:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:51:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:51:01 INFO - 'HOME': '/Users/cltbld', 15:51:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:51:01 INFO - 'LOGNAME': 'cltbld', 15:51:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:01 INFO - 'MOZ_NO_REMOTE': '1', 15:51:01 INFO - 'NO_EM_RESTART': '1', 15:51:01 INFO - 'PAGER': '/bin/cat', 15:51:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:51:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:01 INFO - 'PWD': '/builds/slave/test', 15:51:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:51:01 INFO - 'SHELL': '/bin/bash', 15:51:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:51:01 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:51:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:51:01 INFO - 'USER': 'cltbld', 15:51:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:51:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:51:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:01 INFO - 'XPC_FLAGS': '0x0', 15:51:01 INFO - 'XPC_SERVICE_NAME': '0', 15:51:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:51:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:51:01 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-CfLPCq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:51:01 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)) 15:51:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:51:01 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-_FBwEt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:51:01 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)) 15:51:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:51:01 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-nBSUNe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:51:01 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)) 15:51:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-FleAgw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:51:02 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)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-0033Bt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:51:02 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)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-3GkB_l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:51:02 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)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-Kn5fhz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:51:02 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)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-el4kjr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:51:02 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)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-p3s6zC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:51:02 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)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-m6Nk95-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:51:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-DWgxqF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:51:02 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)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-T7RB5I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:51:02 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)) 15:51:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:51:02 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-ikz5Y_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:51:03 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)) 15:51:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:51:03 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-IFnVxI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:51:03 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)) 15:51:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:51:03 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-GH8zgp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:51:03 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)) 15:51:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:51:03 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-Jzz5zH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:51:03 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)) 15:51:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:51:03 INFO - Running setup.py (path:/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/pip-_cV47z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:51:03 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)) 15:51:03 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)) 15:51:03 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)) 15:51:03 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)) 15:51:03 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)) 15:51:03 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)) 15:51:03 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:51:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:51:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:51:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:51:05 INFO - Downloading blessings-1.6.tar.gz 15:51:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:51:06 INFO - Installing collected packages: blessings 15:51:06 INFO - Running setup.py install for blessings 15:51:06 INFO - Successfully installed blessings 15:51:06 INFO - Cleaning up... 15:51:06 INFO - Return code: 0 15:51:06 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:51:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:51:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:51:06 INFO - Reading from file tmpfile_stdout 15:51:06 INFO - Current package versions: 15:51:06 INFO - blessings == 1.6 15:51:06 INFO - blobuploader == 1.2.4 15:51:06 INFO - docopt == 0.6.1 15:51:06 INFO - functools32 == 3.2.3-2 15:51:06 INFO - jsonschema == 2.5.1 15:51:06 INFO - manifestparser == 1.1 15:51:06 INFO - mozInstall == 1.12 15:51:06 INFO - mozcrash == 0.17 15:51:06 INFO - mozdebug == 0.1 15:51:06 INFO - mozdevice == 0.48 15:51:06 INFO - mozfile == 1.2 15:51:06 INFO - mozhttpd == 0.7 15:51:06 INFO - mozinfo == 0.9 15:51:06 INFO - mozleak == 0.1 15:51:06 INFO - mozlog == 3.3 15:51:06 INFO - moznetwork == 0.27 15:51:06 INFO - mozprocess == 0.23 15:51:06 INFO - mozprofile == 0.28 15:51:06 INFO - mozrunner == 6.12 15:51:06 INFO - mozscreenshot == 0.1 15:51:06 INFO - mozsystemmonitor == 0.3 15:51:06 INFO - moztest == 0.7 15:51:06 INFO - mozversion == 1.4 15:51:06 INFO - psutil == 3.1.1 15:51:06 INFO - requests == 1.2.3 15:51:06 INFO - wsgiref == 0.1.2 15:51:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:51:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:51:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:51:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:06 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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:51:06 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 15:51:06 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 15:51:06 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:51:06 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:51:06 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:51:06 INFO - 'HOME': '/Users/cltbld', 15:51:06 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:51:06 INFO - 'LOGNAME': 'cltbld', 15:51:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:06 INFO - 'MOZ_NO_REMOTE': '1', 15:51:06 INFO - 'NO_EM_RESTART': '1', 15:51:06 INFO - 'PAGER': '/bin/cat', 15:51:06 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:51:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:06 INFO - 'PWD': '/builds/slave/test', 15:51:06 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:51:06 INFO - 'SHELL': '/bin/bash', 15:51:06 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:51:06 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:51:06 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:51:06 INFO - 'USER': 'cltbld', 15:51:06 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:51:06 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:51:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:06 INFO - 'XPC_FLAGS': '0x0', 15:51:06 INFO - 'XPC_SERVICE_NAME': '0', 15:51:06 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:51:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 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)) 15:51:06 INFO - Cleaning up... 15:51:06 INFO - Return code: 0 15:51:06 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:51:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:51:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:51:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:51:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:51:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:51:06 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 0x107970a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107a05618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa95149c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, '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.AQbPoEoF21/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.xueSlZnyuT/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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 15:51:06 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 15:51:06 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 15:51:06 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:51:06 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:51:06 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:51:06 INFO - 'HOME': '/Users/cltbld', 15:51:06 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:51:06 INFO - 'LOGNAME': 'cltbld', 15:51:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:06 INFO - 'MOZ_NO_REMOTE': '1', 15:51:06 INFO - 'NO_EM_RESTART': '1', 15:51:06 INFO - 'PAGER': '/bin/cat', 15:51:06 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:51:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:06 INFO - 'PWD': '/builds/slave/test', 15:51:06 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:51:06 INFO - 'SHELL': '/bin/bash', 15:51:06 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:51:06 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:51:06 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:51:06 INFO - 'USER': 'cltbld', 15:51:06 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:51:06 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:51:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:06 INFO - 'XPC_FLAGS': '0x0', 15:51:06 INFO - 'XPC_SERVICE_NAME': '0', 15:51:06 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:51:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:51:07 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 15:51:07 INFO - Cleaning up... 15:51:07 INFO - Return code: 0 15:51:07 INFO - Running post-action listener: _resource_record_post_action 15:51:07 INFO - Running post-action listener: _start_resource_monitoring 15:51:07 INFO - Starting resource monitoring. 15:51:07 INFO - [mozharness: 2016-09-07 22:51:07.144723Z] Finished create-virtualenv step (success) 15:51:07 INFO - [mozharness: 2016-09-07 22:51:07.145695Z] Running install step. 15:51:07 INFO - Running pre-action listener: _resource_record_pre_action 15:51:07 INFO - Running main action method: install 15:51:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:51:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:51:07 INFO - Reading from file tmpfile_stdout 15:51:07 INFO - Detecting whether we're running mozinstall >=1.0... 15:51:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:51:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:51:07 INFO - Reading from file tmpfile_stdout 15:51:07 INFO - Output received: 15:51:07 INFO - Usage: mozinstall [options] installer 15:51:07 INFO - Options: 15:51:07 INFO - -h, --help show this help message and exit 15:51:07 INFO - -d DEST, --destination=DEST 15:51:07 INFO - Directory to install application into. [default: 15:51:07 INFO - "/builds/slave/test"] 15:51:07 INFO - --app=APP Application being installed. [default: firefox] 15:51:07 INFO - mkdir: /builds/slave/test/build/application 15:51:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 15:51:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 15:51:41 INFO - Reading from file tmpfile_stdout 15:51:41 INFO - Output received: 15:51:41 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 15:51:41 INFO - Running post-action listener: _resource_record_post_action 15:51:41 INFO - [mozharness: 2016-09-07 22:51:41.645198Z] Finished install step (success) 15:51:41 INFO - [mozharness: 2016-09-07 22:51:41.645338Z] Running run-tests step. 15:51:41 INFO - Running pre-action listener: _resource_record_pre_action 15:51:41 INFO - Running main action method: run_tests 15:51:41 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 15:51:41 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 15:51:41 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 15:51:41 INFO - 2016-09-07 15:51:41.659 screenresolution[1646:9088] starting screenresolution argv=screenresolution get 15:51:41 INFO - 2016-09-07 15:51:41.662 screenresolution[1646:9088] Display 0: 1600x1200x32@60 15:51:41 INFO - 2016-09-07 15:51:41.668 screenresolution[1647:9090] starting screenresolution argv=screenresolution list 15:51:41 INFO - Available Modes on Display 0 15:51:41 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 15:51:41 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 15:51:41 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 15:51:41 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 15:51:41 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 15:51:41 INFO - Intel Iris: 15:51:41 INFO - Chipset Model: Intel Iris 15:51:41 INFO - Type: GPU 15:51:41 INFO - Bus: Built-In 15:51:41 INFO - VRAM (Dynamic, Max): 1536 MB 15:51:41 INFO - Vendor: Intel (0x8086) 15:51:41 INFO - Device ID: 0x0a2e 15:51:41 INFO - Revision ID: 0x0009 15:51:41 INFO - Displays: 15:51:41 INFO - Display: 15:51:41 INFO - Resolution: 1600 x 1200 @ 60 Hz 15:51:41 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 15:51:41 INFO - Display Serial Number: 1600x1200 60 15:51:41 INFO - Main Display: Yes 15:51:41 INFO - Mirror: Off 15:51:41 INFO - Online: Yes 15:51:41 INFO - Rotation: Supported 15:51:41 INFO - Return code: 0 15:51:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:51:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:51:41 INFO - Python 2.7.3 15:51:41 INFO - Return code: 0 15:51:41 INFO - grabbing minidump binary from tooltool 15:51:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:51:41 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1078d4d30>, '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 0x107639db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078ccb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:51:41 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 15:51:41 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 15:51:41 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 15:51:41 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:51:42 INFO - Return code: 0 15:51:42 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 15:51:42 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:51:42 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:51:42 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 15:51:42 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:51:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0251', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 15:51:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0251 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 15:51:42 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.AQbPoEoF21/Render', 15:51:42 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:51:42 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:51:42 INFO - 'HOME': '/Users/cltbld', 15:51:42 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:51:42 INFO - 'LOGNAME': 'cltbld', 15:51:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:51:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 15:51:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:51:42 INFO - 'MOZ_NO_REMOTE': '1', 15:51:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:51:42 INFO - 'NO_EM_RESTART': '1', 15:51:42 INFO - 'PAGER': '/bin/cat', 15:51:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:51:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:51:42 INFO - 'PWD': '/builds/slave/test', 15:51:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:51:42 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:51:42 INFO - 'SHELL': '/bin/bash', 15:51:42 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xueSlZnyuT/Listeners', 15:51:42 INFO - 'TMPDIR': '/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/', 15:51:42 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:51:42 INFO - 'USER': 'cltbld', 15:51:42 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:51:42 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:51:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:51:42 INFO - 'XPC_FLAGS': '0x0', 15:51:42 INFO - 'XPC_SERVICE_NAME': '0', 15:51:42 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:51:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0251', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 15:51:42 INFO - mozversion application_buildid: 20160907145315 15:51:42 INFO - mozversion application_changeset: a1e635fc39e261b45e5799809a051b6b51a10f59 15:51:42 INFO - mozversion application_display_name: Nightly 15:51:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:51:42 INFO - mozversion application_name: Firefox 15:51:42 INFO - mozversion application_remotingname: firefox 15:51:42 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 15:51:42 INFO - mozversion application_vendor: Mozilla 15:51:42 INFO - mozversion application_version: 51.0a1 15:51:42 INFO - mozversion platform_buildid: 20160907145315 15:51:42 INFO - mozversion platform_changeset: a1e635fc39e261b45e5799809a051b6b51a10f59 15:51:42 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 15:51:42 INFO - mozversion platform_version: 51.0a1 15:51:42 INFO - using testdate: 1473288702 15:51:42 INFO - actual date: 1473288702 15:51:42 INFO - starting webserver on 'localhost:49268' 15:51:42 INFO - SUITE-START | Running 2 tests 15:51:42 INFO - TEST-START | dromaeo_css 15:51:42 INFO - operating with platform_type : mac_ 15:51:42 INFO - Initialising browser for dromaeo_css test... 15:51:42 INFO - TEST-INFO | started process 1657 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/tmplXSbtn/profile http://localhost:49268/getInfo.html) 15:51:44 INFO - PROCESS | 1657 | __metrics Screen width/height:1600/1200 15:51:44 INFO - PROCESS | 1657 | colorDepth:24 15:51:44 INFO - PROCESS | 1657 | Browser inner width/height: 1024/689 15:51:44 INFO - PROCESS | 1657 | __metrics 15:51:44 INFO - PROCESS | 1657 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 15:51:44 INFO - PROCESS | 1657 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:51:45 INFO - TEST-INFO | 1657: exit 0 15:51:45 INFO - Browser initialized. 15:51:45 INFO - Running cycle 1/1 for dromaeo_css test... 15:51:45 INFO - TEST-INFO | started process 1660 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/tmplXSbtn/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:51:57 INFO - PROCESS | 1660 | RSS: Main: 232275968 15:51:57 INFO - PROCESS | 1660 | 15:52:49 INFO - PROCESS | 1660 | 1473288769325 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] 15:55:00 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49268/tests/dromaeo/cssquery-ext.html) 15:55:03 INFO - PROCESS | 1660 | RSS: Main: 483844096 15:55:03 INFO - PROCESS | 1660 | 15:58:06 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-ext.html (next: http://localhost:49268/tests/dromaeo/cssquery-jquery.html) 15:58:07 INFO - PROCESS | 1660 | RSS: Main: 371429376 15:58:07 INFO - PROCESS | 1660 | 16:01:09 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49268/tests/dromaeo/cssquery-mootools.html) 16:01:10 INFO - PROCESS | 1660 | RSS: Main: 343859200 16:01:10 INFO - PROCESS | 1660 | 16:04:12 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49268/tests/dromaeo/cssquery-prototype.html) 16:04:13 INFO - PROCESS | 1660 | RSS: Main: 345882624 16:04:13 INFO - PROCESS | 1660 | 16:07:16 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49268/tests/dromaeo/cssquery-yui.html) 16:07:17 INFO - PROCESS | 1660 | RSS: Main: 336244736 16:07:17 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-yui.html (next: http://localhost:49268/tests/dromaeo/cssquery-dojo.html) 16:10:20 INFO - PROCESS | 1660 | RSS: Main: 415764480 16:10:20 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | __start_tp_report 16:10:20 INFO - PROCESS | 1660 | _x_x_mozilla_page_load 16:10:20 INFO - PROCESS | 1660 | _x_x_mozilla_page_load_details 16:10:20 INFO - PROCESS | 1660 | |i|pagename|runs| 16:10:20 INFO - PROCESS | 1660 | |0;dojo.html;3322.368749937512;3333.200031992322;3352.0781785009103;3356.8153751543655;3428.177237463008;5609.915851262224;5638.859028524289;5664.1220610805285;5686.147077938306;5734.053881109622;5722.656640601556;5740.655560666363;5759.366469688331;5775.942240577593;5781.306243250805;4431.047324825162;5221.060209162359;5245.868853278679;5283.498067683564;5283.603729720267;5330.333708286465;5352.57179425645;5356.38401583819;5357.1696387060065;5360.812371566996;5246.003259380725;5266.973665131688;5302.840914772543;5316.175992721134;5359.410464848864;5346.331708536452;5353.063213937584;5361.651492653004;5363.704996225206;5387;5166.664166829144;5173.741312934339;5204.609654275944;5289.233061206103;5302.072137375943;4767.904641907177;5698.886022279573;5733.082706766897;5770.567207459458;5815.621984571032;6291.748330066792;6295.622262664209;6296.905546416808;6306.873862522724;6313.87372252557;6177.722002509898;6240.313565507836;6251.468625166866;6256.562040657156;6302.716377763011;5857.355690874;5860.3260625027815;5863.853403664943;5893.351731309553;5916.3787802281;5690.146478028329;6214.844628884314;6280.340564240689;6296.65368404733;6311;5884.08796636522;5954.345022047572;6039;6183.96908015466;6207.037909124093;6253;6265.530085243534;6273.96863015682;6294.716737746812;6316.178896743486;6236.314005459396;6268.811935641938;6281.120643109968;6281.183446152062;6308.684565771693;4646.721196728207;6146.293176284695;6148.1085242640465;6314.873702526015;6324.146240257506;4990.925136122961;4992.975035124874;4997.575206107522;4999.675021123615;5001.524855138756;4437.489688685778;4498.50516443191;4504.81980720774;4539.409876716006;4552.2488789350045;5710.486056254957;5717.371089180187;5718.170865224519;5742.7415766290615;5745.224394706661;6319.747210111636;6328.240611126695;6331.9366806331345;6343.080253363237;6349.746010159634;5608.327000759935;5608.887822243532;5684.8294551163535;5711.600187986801;5733.88532229353;5488.039593071197;5495.752691128909;5501.642393244426;5535.750891209906;5554.166874968787;6274.62352258875;6324.841878953063;6327.493800496041;6330.936690633127;6332.493400527855;6064.120702498025;6167.229096362955;6316.968415158079;6329.367063293634;6341.651209183539;5643.238162847963;6287.497000239879;6293.779717709858;6294.118823364641;6310.873782524415;6199.814005579839;6235.282942461675;6249.9375006251175;6256.31180570146;6257.28041275241;6104.398524058527;6105.732692890381;6310.432061114522;6322.209723784527;6330.556861019684;5878.882422351615;6013.9699301503215;6076.392360764065;6082.2093127893095;6113.57204995646;6059.272887253382;6063.029915213545;6065.636061836304;6077.513798896166;6080.939190608037;5879.911801323069;5884.117382392676;5890.910181616415;5893.734781934738;5896.734646940984;6043.09353596964;6058.091286307089;6061.15143879866;6065.696715164136;6087.847803804763;5907.616004959664;5934.139549765347;5935.525157987437;5936.257967754031;5997.460228579449 16:10:20 INFO - PROCESS | 1660 | |1;ext.html;518.3727689495709;520.9557187639051;531.7952588253523;533.4452169743467;554.1853475391174;34462.827685861565;40950.590494095086;41272.793636031856;41308.99999999996;43206.35190472146;43132.56867431325;43439.3484097738;43486;43509.34735978955;43512.56487435125;8780.780480487974;8924.464532128093;9834.262430317736;9993.650222242222;10003.099721025106;11938.820917686198;12165.148439609187;12183.269003859798;12406.441710123021;12417.689557761083;12203;12301.954333881631;12303.015758739324;12314.19957702751;12314.630561083182;10274.897251027469;10337.638182663646;12274.079444041732;12302.384880755926;12316.322602256918;11975.101867359983;12054.975327097207;12056.578019769266;12057.09571782111;12067.456964436622;40480.59519404798;40775.77672669825;40909.1818163635;40916;40933.79533102315;3382.0868365541414;3454.7063499602564;3468.150303175738;3570.5001299817786;3818.7899665518385;30290.69709302923;31382.843085784654;31652.683473165434;31654.683453165402;31971.84014079938;3242.400155971153;3279.2293810954407;3295.1926777939557;3330.601147518048;3390.7117894978956;512328;514449.9999999963;514920;514993;516035;50884.745576272624;53923.73038134863;54018;57962.7101864488;59264.70367648134;62101.68949155225;62653;63192.68403657952;63199.736005279636;63256.41858953471;15347.769783453257;15515.767263491056;15522.689546209012;15527.223638818014;15528.922355388377;10913.18151138652;11059.557617695202;11829.52681892732;11887.227330223508;12066.939665301617;15901.761473577906;15911.840881591268;15943.282552284943;15978.440754573534;16035.438759643357;6150.661713605795;6173.41352571505;6209.844753881189;6215.968920155461;6238.282597501346;859.7420773767844;914.7713071732067;920.7513971227731;927.1007123090726;981.9754506137261;27147.321316967234;29928.102156935325;30314.80838828012;30536.236594085327;30858.074257772303;1004.5379125602304;1052.273930987616;1078.789636020984;1108.3682301088463;1157.7105723569107;14878.479253226302;15380.846191538165;15572.305695602347;15626.76559851603;15758.527244182693;658611;660617;661071;661407;662985;58241.83516329734;58268.708656456445;58374.708126459096;58379.41620583825;58428.4157158423;1224.8958838498827;1338.2773302416585;1358.9728205435836;1381.7650999330137;1386.0713322074032;29952.95164669226;30956.0713178605;31064.22339441532;31759.364812703156;31889.043328700176;48480;55043.72478137584;55997.16004260021;56090;58751;608534;613990;614874;615364.2331131977;617606;24379.26862194137;24700;24717;25422;25607.847646855564;45158.77420612876;45354;45359.86600334886;45964.77017614891;45982.310265345375;36861.07847303839;37817.62182378141;37967.24065518729;39044.0238994016;39315;33735.662643374235;35809.82095089508;37533.249335013694;37552;38742;37369.813150934075;37532.624673754006;37910.862674119824;37938.43092353562;38259.42610860783;30905.227369315948;33293.83353083219;33718;33753.81861634831;34197.80307689219;24383;24966;25288.494230114928;25394.619080713434;26904.596431053942 16:10:20 INFO - PROCESS | 1660 | |2;jquery.html;348.0862735319786;362.1868904309825;367.86756767563674;376.19118894377084;398.90426297688543;14905;15218.77171842422;20410.489737756565;20580.765154090765;21035.477372364938;19393.515162120955;19823;20082.899585502088;20286.79713202871;20423.48941276465;5029.641996660899;5413.783448662049;5658.377578466366;5661.971690141564;5674.914876276859;3435.7594968352223;4157.251694694954;6166.81499555014;6207.782727604535;6267.310595834455;5919.1713160157615;6135.202423684915;6183.6598987055695;6220.377962203788;6221.59559628625;6002.099685047234;6115.296740874767;6142.659279778376;6185.969070154621;6196.628202307876;6025;6027.216461859974;6034.879302413927;6041.848953776147;6042.214512113397;16779.66440671192;24152.03391864341;24438.14466493682;24806.131785387606;25489.872550637312;2122.4587730128874;2130.648443006902;2135.9145634174615;2177.2162021672184;2211.800937915579;9872.765904261967;10328.896711032869;10349.844752328721;13012.804807927794;14894;1433.9928300358536;1868.6075924055829;1873.7751469823572;1874.3627166763229;1884.510027392874;126703.36648316792;128911;130798;131383;131513.34243328817;9285.907140928639;11483.25358851672;11506.928752824404;11525.193236473535;11684.532618695326;14568.927155364367;14582.979191456496;14600.780988285183;14613.19627420502;14615.050021748764;8150.2664760171865;8471.19523645265;8475.110113438124;8564.357673174412;8575.528345940907;8284.751457456287;8285.461445006054;8288.958555207186;8451.661933522713;8493.575321233913;3859.1316953685196;4492.9550704493195;4509.1658043262105;4521.570450807168;4528.479224889114;1631.5757902945081;1773.5388798912375;1856.5729882127187;1934.9489541086493;1953.9218431262875;701.8105111619936;797.8723404255292;860.1355637584188;879.3800370738614;936.2118353943935;16582.17089145538;19385.321513746952;19935.800641993683;20907;21145;859.072202021815;969.3699095587924;986.1519093579516;986.6102889358807;1023.9283250172416;10127.240456965757;10387.84418233727;10705.9464702676;10815.459227038775;11011.28426652265;613402;622599.887000562;626258;627113;629922;130955;132205;133000;134439;142260.28869855584;962.5620342744035;999.2056315229265;1012.4026824173773;1013.6452241715488;1019.5208252121491;14517.85482145165;16821;18658.53353666115;18678.53303667419;18724;55884.72057639686;56144;57292.71353643205;57322.7133864328;58967;68542.83614841971;83080;85997;86416.46961190467;88552;6091.786787462417;7914.525128492309;8119.188081191834;8154.75535733929;8282.834343313221;10773.838392423962;11055.94472027667;12206.694832629255;12861.549845755353;12865.549705760253;10764.569417223223;10908.40003799767;11009.669709908716;11130.499127539118;11196.888031119584;10769.838452423062;10856.891431085904;10910.727231819268;11032.503537341;11167.939045790637;11173;11247.381394023407;11255.549778008788;11283.548658053585;11385;7882.448228623941;7903.723369682033;8308.916910831056;8381.245687888118;8408.957955210184;10061.849072263776;11121.110311175249;11312.490937907649;11489.712757181138;11563.248388854698 16:10:20 INFO - PROCESS | 1660 | |3;mootools.html;1378.9310534473275;1444.4511085787399;1520.847915208479;1864.0959134819602;1914.387396033269;8513.702020429278;9043.593038313275;9058;9059.592318345674;9065.365424420293;7830.2561256680665;8091.554964476966;8556.74329770108;8780.824383512327;8886.955565222164;2398.5322862041867;2435.695538057743;2437.5368679950843;2439.890204940782;2444.9144279950206;2149.892505374733;2313.669639957023;2397.652340410639;2419.4798118404537;2433.610622300432;2207.558488302346;2300.5621486570894;2390.115657206827;2393.9880300598475;2399.78401943825;2382.833201675883;2394.174009966559;2403.305669503005;2406.6750988616486;2416.6979127609047;2398.988005059981;2399.3281881073326;2409.0968135173366;2411.565918134735;2412.2039726890084;8871.911280887238;8919.598618062202;8953.731388058304;8965.058668839809;8975.820483590292;5297.549708274802;5447.291852059247;5448.700321482317;5455.754491047873;5461.1262198048125;3603.1352475405974;3617.4935509028755;3667.3948798448223;3690.7231957603285;3701.5188025556777;953.9379940303858;954.0650162840386;958.6213445688984;969.961201551937;975.4196253229317;11487.368194749286;11615.186936914419;11616.36110013949;11706.180567360203;11745.29528228309;4247.895547157761;4586.839460618862;4632.907341853144;4720.905581888343;4811.350467686818;10022.248331375176;10023.949880250551;10029.648962286285;10032.598696052222;10040.246981476419;5397.325334333208;5414.566834653218;5423.83728488146;5430.402655707869;5451.373092094381;4097.262492751273;4367.27939889921;4441.511433742286;4586.105709386704;4972.0801651694555;3523.436250199956;3902.35611124167;3906.902327441837;3931.331673615492;4123.8556650517085;1033.3851358441866;1291.115585823695;1299.5191779041816;1301.7071158989152;1316.2431601828987;794.5788731972063;866.6360128745941;896.2919293757858;917.1378903830378;936.3164889630608;5732.312122545238;5817.272840894888;6030.879382412327;6039.698015099228;6280.717367718464;910.2717825739514;935.4434111703525;938.8685584018243;940.2759874896428;983.4640121133999;3823.7323387363176;3845.2309538092495;3945.6251656092627;3964.0882597002274;3996.5603783583783;10120.898791011996;10857.45712714361;10953.068989136013;10990.395528246023;11006.449677516091;10497.002784735438;10836;10905.890941090645;10918.781624367468;10921.781564368668;8065.233802788725;8105.067917189481;8277.751667449986;8302.54336011513;8325.042620098646;5612.438756124355;5670;5778.479936805707;5833.970830145992;5834.591578589458;10073.244506661884;10093.949530252301;10095.141912937188;10130.89869101329;10159.288849780445;8797;9692.369995950523;9774.902250977399;10271.383716977005;10276.537555810157;6918.688659010256;7126.251743566851;7143.6428178591905;7425.146108197627;7628.970089037909;7921.841563168819;7997.800054998672;8111.269985701315;8386.329093672613;8401.53791541471;7377.409807215303;7570.9242907570215;7577.583232922242;7642.923570764221;7696.46124771283;7282.960770984133;7420.5547667140145;7445.181030086578;7483.550986940801;7583.090029196532;6923.099997000358;7048.471364647775;7056.576605403692;7058.611776352144;7081.539699919489;4765.428148622187;4877.195262781602;4997.1754660482065;5082.161443361804;5121.231815227597;4916.459189489225;4957.856234096612;5076.18780995039;5135.486451354835;5253.973730131325 16:10:20 INFO - PROCESS | 1660 | |4;prototype.html;299.77067543329355;303.2676087249293;309.38432519286624;312.9702678245566;315.62125449460655;4906.828261010865;5093.821716239937;5350.512011914459;5441.646292990953;5449.591280653947;4222.598853108957;4674;4927.014597080589;5043.092243396187;5074.822381216658;3305.2893627870003;3886;4021.9798901005456;4024.9597504025023;4133.3386658134705;3630.80030598317;4076.429299898017;4094.324436467979;4106.568810274923;4141.420201171838;3811.485449464328;3939.1289137659523;4027.677785777131;4044.4337792709043;4077.5718549552316;4005.6595189408645;4021.4973128358956;4051.176970363348;4064.979675101635;4077.2049450357194;3499.9825000874835;3509.4209455439823;3519.1729943463265;3529.5588051493564;3539.3983022886173;4172.666186705056;4982.850514484571;5193.428722840485;5212.322398088262;5246.580273578104;4626.86119416418;4664.463586687541;4680.017196388762;4681.578657920803;4681.9297710534365;4712.740799256039;4725.149473094842;5375;5422.620416570841;5610.438956104357;3363.798172109681;3711.9628803712158;3888.5333759948703;3897.337452633059;3936.940945885814;4906.435759887623;5227.849873027966;5659.745311460994;5893.911591326134;5987.191729116601;3919.6080391960577;3927.8625248116177;3938.783366914847;3954.703397245218;3978.462907507507;3403.8808641697424;3729.4266955800413;3734.981325093357;4027.81874815634;4057.127717540743;4360.629346505519;4648.279516674921;4667.883302917454;4671.509491503343;4672.766361681903;5613.298337707786;5625.959197548466;5628.774849006076;5640.689762063043;5661.830145095653;1232.3099064523717;1262.6022802817083;1337.525178561616;1367.6444124527695;1379.537854818647;838.3167718309559;872.1975782280317;899.8020435504178;921.3964853021282;948.8339540580508;5152.660308319864;5160.8967820643375;5187.158558711679;5196.298499702491;5220.582353411718;4550.544945505423;4832.661713680079;5725.770969161187;5747.540196784247;5815.88368232633;4469.7318160910445;4541.523140070245;4852.8544143675745;5015.749212539358;5127.0260949534695;2393.5452264069772;2563.9871800640876;2805.845678487662;3014.6033903047132;3019.879204831826;4938.185199442052;5020;5124.052050370693;5466.9179962300595;5787.971060144672;5122.9743851281255;5371.791346946984;5839.912401313899;5859.619124756877;5884.382139875337;5920.378360272195;5922.407759224129;5940.524758019348;5957.582969192115;5965.373635768268;4525.434320709911;5174.826572839341;5710.2291190690385;5728.4769866532615;5868.501177399969;4837.564619184291;5766.933117373132;5858.455634341332;5861.35525092248;5868.129452554455;5239.607029472881;5510.068488702669;6140.267580926445;6140.5701600887505;6177.938220617916;3537.8407971640822;3599.964000359963;3768.4158955361963;3852.788096654711;3900.893517500518;5798.69474399605;5828.883422331445;5832.24180856486;5842.444967728059;5850.648961062179;5668.121441176624;5668.546516278605;5671.829845104653;5700.287464066992;5726.255586773693;4844.975775121102;5174.249733788655;5331.4805280494875;5686.004949133968;5705;4898.559129678346;5320.441353657965;5603.299587551556;5605.831825045255;5622.522085622604;5170.224466330081;5314.468553144655;5573.860653483695;5693.1460280956535;5765.827025189251;4690.390249267573;5528.175702018405;5553.72231388437;5593.300837395325;5604.719764011702 16:10:20 INFO - PROCESS | 1660 | |5;yui.html;715.2204097533688;728.8141523911405;760.615888976067;799.9960000199998;818.8567000774866;14817.481388151416;16192.919035404835;16206.946548474356;16209.513714588551;16238.025718456885;14600.26998650066;14747.410103595843;14752.704945901076;14786;14804.333804978774;675.8884784010656;689.8896176611743;847.516915358246;852.0840096895831;863.3050394432479;837.5184269045324;851.2934264560431;851.8296340731847;853.1340689200466;853.2619284319081;875.5665945357025;893.7586851550078;895.8611415230617;896.4128495835206;900.3472482450237;712.4905692429937;878.7232021913077;886.6896586194845;893.2675206330812;893.271983333581;666.040901102411;667.0594461808827;668.0446960845989;668.4585485756553;669.6819010969799;14066.859331406657;14084.577462676034;14106.85893141076;14131.010829241957;14209.78685319721;13533.120347177402;13684.110532815435;13842;13928.233947132903;14225.217613031278;12653.177543459738;12852.614421567274;12887;13106.541271055563;13146.671333216651;4476.6418686505;4578.084383123389;4626;4628.282616194461;4650.279206722963;125341;129805;131086;131087.34456327753;132281.33859330643;10449.477526123663;10989;11008.724781880357;11269.323840569592;11459.255148415326;21364;21545.353639390843;21681.241156559445;21743.673844892022;21772.782272177075;7835.022691377354;7877.842443151105;7928.405369597303;8123.309518690978;8130.634121464548;4453.866384008485;4465.866024019285;4499.6400287976885;4601.585857272861;4673.065386922561;3394.4908263760635;3495.3883070462566;3506.193575477603;3506.982465087658;3507.035565219585;606.3905774696402;606.5905513778271;643.5077165968038;651.5569412799342;660.2638058564762;518.429727299967;527.5463101732507;540.8318033048596;567.619694804482;578.3695771608882;8293.751187464386;8623.827523449496;8743.81228221468;8795.604197811113;9007.459552426875;578.3506076656312;590.4508806809708;606.2028432611103;615.7321565119188;617.5677026081761;3397.490376443504;4229.407882896397;4361.127774445124;4426.645868330525;4463.375127482155;110569.44715276372;110865;137435;151580.72628910575;164195;138810.3059484696;139601.30199348938;140485;142592;150881.24559377134;123688.38155809163;124127;125825;127714.36142819226;128458.71541284655;6681.864083105981;8400.327973761961;8447.366447516339;8503.702370417006;8596.226339629464;61032.38967610267;64747;65098;66438;66728;78653.60673196598;93364.06635933554;95292;98068;100385;11618.941905290758;11644.941775291069;11801.409929503663;11852.111091667986;11970.401479925795;12204.938975305422;12205.450754716237;12329.260244385365;12702.174358666656;12707.237565746085;11762.411879406167;11938.28370297785;11938.880611193777;11974.161808673309;12251.75496490083;11510.424733573542;11659.591914282959;11818.940905295418;12209.206401583868;12316.199447035913;10839.891601083888;11005.284656497302;11086.667399978014;11569.479373428385;12259.570915017932;8646.875906132163;9639.71080867575;9799.069088436587;9874.30879838433;9877.95061024719;8007.599620019092;9911.504424778876;9934.40015902986;9958.651447199314;9988.740470320936 16:10:20 INFO - PROCESS | 1660 | __end_tp_report 16:10:20 INFO - PROCESS | 1660 | __start_cc_report 16:10:20 INFO - PROCESS | 1660 | _x_x_mozilla_cycle_collect,2465 16:10:20 INFO - PROCESS | 1660 | __end_cc_report 16:10:20 INFO - PROCESS | 1660 | __startTimestamp1473289820874__endTimestamp 16:10:20 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | ------- Summary: start ------- 16:10:20 INFO - PROCESS | 1660 | Number of tests: 6 16:10:20 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | [#0] dojo.html Cycles:165 Average:5749.33 Median:5893.73 stddev:637.40 (10.8%) stddev-sans-first:610.26 16:10:20 INFO - PROCESS | 1660 | Values: 3322.4 3333.2 3352.1 3356.8 3428.2 5609.9 5638.9 5664.1 5686.1 5734.1 5722.7 5740.7 5759.4 5775.9 5781.3 4431.0 5221.1 5245.9 5283.5 5283.6 5330.3 5352.6 5356.4 5357.2 5360.8 5246.0 5267.0 5302.8 5316.2 5359.4 5346.3 5353.1 5361.7 5363.7 5387.0 5166.7 5173.7 5204.6 5289.2 5302.1 4767.9 5698.9 5733.1 5770.6 5815.6 6291.7 6295.6 6296.9 6306.9 6313.9 6177.7 6240.3 6251.5 6256.6 6302.7 5857.4 5860.3 5863.9 5893.4 5916.4 5690.1 6214.8 6280.3 6296.7 6311.0 5884.1 5954.3 6039.0 6184.0 6207.0 6253.0 6265.5 6274.0 6294.7 6316.2 6236.3 6268.8 6281.1 6281.2 6308.7 4646.7 6146.3 6148.1 6314.9 6324.1 4990.9 4993.0 4997.6 4999.7 5001.5 4437.5 4498.5 4504.8 4539.4 4552.2 5710.5 5717.4 5718.2 5742.7 5745.2 6319.7 6328.2 6331.9 6343.1 6349.7 5608.3 5608.9 5684.8 5711.6 5733.9 5488.0 5495.8 5501.6 5535.8 5554.2 6274.6 6324.8 6327.5 6330.9 6332.5 6064.1 6167.2 6317.0 6329.4 6341.7 5643.2 6287.5 6293.8 6294.1 6310.9 6199.8 6235.3 6249.9 6256.3 6257.3 6104.4 6105.7 6310.4 6322.2 6330.6 5878.9 6014.0 6076.4 6082.2 6113.6 6059.3 6063.0 6065.6 6077.5 6080.9 5879.9 5884.1 5890.9 5893.7 5896.7 6043.1 6058.1 6061.2 6065.7 6087.8 5907.6 5934.1 5935.5 5936.3 5997.5 16:10:20 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | [#1] ext.html Cycles:180 Average:72563.09 Median:3519.33 stddev:160384.02 (4557.2%) stddev-sans-first:160742.73 16:10:20 INFO - PROCESS | 1660 | Values: 518.4 521.0 531.8 533.4 554.2 34462.8 40950.6 41272.8 41309.0 43206.4 43132.6 43439.3 43486.0 43509.3 43512.6 8780.8 8924.5 9834.3 9993.7 10003.1 11938.8 12165.1 12183.3 12406.4 12417.7 12203.0 12302.0 12303.0 12314.2 12314.6 10274.9 10337.6 12274.1 12302.4 12316.3 11975.1 12055.0 12056.6 12057.1 12067.5 40480.6 40775.8 40909.2 40916.0 40933.8 3382.1 3454.7 3468.2 3570.5 3818.8 30290.7 31382.8 31652.7 31654.7 31971.8 3242.4 3279.2 3295.2 3330.6 3390.7 512328.0 514450.0 514920.0 514993.0 516035.0 50884.7 53923.7 54018.0 57962.7 59264.7 62101.7 62653.0 63192.7 63199.7 63256.4 15347.8 15515.8 15522.7 15527.2 15528.9 10913.2 11059.6 11829.5 11887.2 12066.9 15901.8 15911.8 15943.3 15978.4 16035.4 6150.7 6173.4 6209.8 6216.0 6238.3 859.7 914.8 920.8 927.1 982.0 27147.3 29928.1 30314.8 30536.2 30858.1 1004.5 1052.3 1078.8 1108.4 1157.7 14878.5 15380.8 15572.3 15626.8 15758.5 658611.0 660617.0 661071.0 661407.0 662985.0 58241.8 58268.7 58374.7 58379.4 58428.4 1224.9 1338.3 1359.0 1381.8 1386.1 29953.0 30956.1 31064.2 31759.4 31889.0 48480.0 55043.7 55997.2 56090.0 58751.0 608534.0 613990.0 614874.0 615364.2 617606.0 24379.3 24700.0 24717.0 25422.0 25607.8 45158.8 45354.0 45359.9 45964.8 45982.3 36861.1 37817.6 37967.2 39044.0 39315.0 33735.7 35809.8 37533.2 37552.0 38742.0 37369.8 37532.6 37910.9 37938.4 38259.4 30905.2 33293.8 33718.0 33753.8 34197.8 24383.0 24966.0 25288.5 25394.6 26904.6 16:10:20 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | [#2] jquery.html Cycles:180 Average:36275.08 Median:2156.57 stddev:104462.57 (4843.9%) stddev-sans-first:104720.79 16:10:20 INFO - PROCESS | 1660 | Values: 348.1 362.2 367.9 376.2 398.9 14905.0 15218.8 20410.5 20580.8 21035.5 19393.5 19823.0 20082.9 20286.8 20423.5 5029.6 5413.8 5658.4 5662.0 5674.9 3435.8 4157.3 6166.8 6207.8 6267.3 5919.2 6135.2 6183.7 6220.4 6221.6 6002.1 6115.3 6142.7 6186.0 6196.6 6025.0 6027.2 6034.9 6041.8 6042.2 16779.7 24152.0 24438.1 24806.1 25489.9 2122.5 2130.6 2135.9 2177.2 2211.8 9872.8 10328.9 10349.8 13012.8 14894.0 1434.0 1868.6 1873.8 1874.4 1884.5 126703.4 128911.0 130798.0 131383.0 131513.3 9285.9 11483.3 11506.9 11525.2 11684.5 14568.9 14583.0 14600.8 14613.2 14615.1 8150.3 8471.2 8475.1 8564.4 8575.5 8284.8 8285.5 8289.0 8451.7 8493.6 3859.1 4493.0 4509.2 4521.6 4528.5 1631.6 1773.5 1856.6 1934.9 1953.9 701.8 797.9 860.1 879.4 936.2 16582.2 19385.3 19935.8 20907.0 21145.0 859.1 969.4 986.2 986.6 1023.9 10127.2 10387.8 10705.9 10815.5 11011.3 613402.0 622599.9 626258.0 627113.0 629922.0 130955.0 132205.0 133000.0 134439.0 142260.3 962.6 999.2 1012.4 1013.6 1019.5 14517.9 16821.0 18658.5 18678.5 18724.0 55884.7 56144.0 57292.7 57322.7 58967.0 68542.8 83080.0 85997.0 86416.5 88552.0 6091.8 7914.5 8119.2 8154.8 8282.8 10773.8 11055.9 12206.7 12861.5 12865.5 10764.6 10908.4 11009.7 11130.5 11196.9 10769.8 10856.9 10910.7 11032.5 11167.9 11173.0 11247.4 11255.5 11283.5 11385.0 7882.4 7903.7 8308.9 8381.2 8409.0 10061.8 11121.1 11312.5 11489.7 11563.2 16:10:20 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | [#3] mootools.html Cycles:180 Average:5718.29 Median:4984.63 stddev:3210.01 (64.4%) stddev-sans-first:3202.44 16:10:20 INFO - PROCESS | 1660 | Values: 1378.9 1444.5 1520.8 1864.1 1914.4 8513.7 9043.6 9058.0 9059.6 9065.4 7830.3 8091.6 8556.7 8780.8 8887.0 2398.5 2435.7 2437.5 2439.9 2444.9 2149.9 2313.7 2397.7 2419.5 2433.6 2207.6 2300.6 2390.1 2394.0 2399.8 2382.8 2394.2 2403.3 2406.7 2416.7 2399.0 2399.3 2409.1 2411.6 2412.2 8871.9 8919.6 8953.7 8965.1 8975.8 5297.5 5447.3 5448.7 5455.8 5461.1 3603.1 3617.5 3667.4 3690.7 3701.5 953.9 954.1 958.6 970.0 975.4 11487.4 11615.2 11616.4 11706.2 11745.3 4247.9 4586.8 4632.9 4720.9 4811.4 10022.2 10023.9 10029.6 10032.6 10040.2 5397.3 5414.6 5423.8 5430.4 5451.4 4097.3 4367.3 4441.5 4586.1 4972.1 3523.4 3902.4 3906.9 3931.3 4123.9 1033.4 1291.1 1299.5 1301.7 1316.2 794.6 866.6 896.3 917.1 936.3 5732.3 5817.3 6030.9 6039.7 6280.7 910.3 935.4 938.9 940.3 983.5 3823.7 3845.2 3945.6 3964.1 3996.6 10120.9 10857.5 10953.1 10990.4 11006.4 10497.0 10836.0 10905.9 10918.8 10921.8 8065.2 8105.1 8277.8 8302.5 8325.0 5612.4 5670.0 5778.5 5834.0 5834.6 10073.2 10093.9 10095.1 10130.9 10159.3 8797.0 9692.4 9774.9 10271.4 10276.5 6918.7 7126.3 7143.6 7425.1 7629.0 7921.8 7997.8 8111.3 8386.3 8401.5 7377.4 7570.9 7577.6 7642.9 7696.5 7283.0 7420.6 7445.2 7483.6 7583.1 6923.1 7048.5 7056.6 7058.6 7081.5 4765.4 4877.2 4997.2 5082.2 5121.2 4916.5 4957.9 5076.2 5135.5 5254.0 16:10:20 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | [#4] prototype.html Cycles:180 Average:4520.58 Median:5017.87 stddev:1393.01 (27.8%) stddev-sans-first:1360.42 16:10:20 INFO - PROCESS | 1660 | Values: 299.8 303.3 309.4 313.0 315.6 4906.8 5093.8 5350.5 5441.6 5449.6 4222.6 4674.0 4927.0 5043.1 5074.8 3305.3 3886.0 4022.0 4025.0 4133.3 3630.8 4076.4 4094.3 4106.6 4141.4 3811.5 3939.1 4027.7 4044.4 4077.6 4005.7 4021.5 4051.2 4065.0 4077.2 3500.0 3509.4 3519.2 3529.6 3539.4 4172.7 4982.9 5193.4 5212.3 5246.6 4626.9 4664.5 4680.0 4681.6 4681.9 4712.7 4725.1 5375.0 5422.6 5610.4 3363.8 3712.0 3888.5 3897.3 3936.9 4906.4 5227.8 5659.7 5893.9 5987.2 3919.6 3927.9 3938.8 3954.7 3978.5 3403.9 3729.4 3735.0 4027.8 4057.1 4360.6 4648.3 4667.9 4671.5 4672.8 5613.3 5626.0 5628.8 5640.7 5661.8 1232.3 1262.6 1337.5 1367.6 1379.5 838.3 872.2 899.8 921.4 948.8 5152.7 5160.9 5187.2 5196.3 5220.6 4550.5 4832.7 5725.8 5747.5 5815.9 4469.7 4541.5 4852.9 5015.7 5127.0 2393.5 2564.0 2805.8 3014.6 3019.9 4938.2 5020.0 5124.1 5466.9 5788.0 5123.0 5371.8 5839.9 5859.6 5884.4 5920.4 5922.4 5940.5 5957.6 5965.4 4525.4 5174.8 5710.2 5728.5 5868.5 4837.6 5766.9 5858.5 5861.4 5868.1 5239.6 5510.1 6140.3 6140.6 6177.9 3537.8 3600.0 3768.4 3852.8 3900.9 5798.7 5828.9 5832.2 5842.4 5850.6 5668.1 5668.5 5671.8 5700.3 5726.3 4845.0 5174.2 5331.5 5686.0 5705.0 4898.6 5320.4 5603.3 5605.8 5622.5 5170.2 5314.5 5573.9 5693.1 5765.8 4690.4 5528.2 5553.7 5593.3 5604.7 16:10:20 INFO - PROCESS | 1660 | 16:10:20 INFO - PROCESS | 1660 | [#5] yui.html Cycles:180 Average:25616.96 Median:4458.62 stddev:42231.75 (947.2%) stddev-sans-first:42308.84 16:10:20 INFO - PROCESS | 1660 | Values: 715.2 728.8 760.6 800.0 818.9 14817.5 16192.9 16206.9 16209.5 16238.0 14600.3 14747.4 14752.7 14786.0 14804.3 675.9 689.9 847.5 852.1 863.3 837.5 851.3 851.8 853.1 853.3 875.6 893.8 895.9 896.4 900.3 712.5 878.7 886.7 893.3 893.3 666.0 667.1 668.0 668.5 669.7 14066.9 14084.6 14106.9 14131.0 14209.8 13533.1 13684.1 13842.0 13928.2 14225.2 12653.2 12852.6 12887.0 13106.5 13146.7 4476.6 4578.1 4626.0 4628.3 4650.3 125341.0 129805.0 131086.0 131087.3 132281.3 10449.5 10989.0 11008.7 11269.3 11459.3 21364.0 21545.4 21681.2 21743.7 21772.8 7835.0 7877.8 7928.4 8123.3 8130.6 4453.9 4465.9 4499.6 4601.6 4673.1 3394.5 3495.4 3506.2 3507.0 3507.0 606.4 606.6 643.5 651.6 660.3 518.4 527.5 540.8 567.6 578.4 8293.8 8623.8 8743.8 8795.6 9007.5 578.4 590.5 606.2 615.7 617.6 3397.5 4229.4 4361.1 4426.6 4463.4 110569.4 110865.0 137435.0 151580.7 164195.0 138810.3 139601.3 140485.0 142592.0 150881.2 123688.4 124127.0 125825.0 127714.4 128458.7 6681.9 8400.3 8447.4 8503.7 8596.2 61032.4 64747.0 65098.0 66438.0 66728.0 78653.6 93364.1 95292.0 98068.0 100385.0 11618.9 11644.9 11801.4 11852.1 11970.4 12204.9 12205.5 12329.3 12702.2 12707.2 11762.4 11938.3 11938.9 11974.2 12251.8 11510.4 11659.6 11818.9 12209.2 12316.2 10839.9 11005.3 11086.7 11569.5 12259.6 8646.9 9639.7 9799.1 9874.3 9878.0 8007.6 9911.5 9934.4 9958.7 9988.7 16:10:20 INFO - PROCESS | 1660 | -------- Summary: end -------- 16:10:20 INFO - PROCESS | 1660 | 16:10:21 INFO - TEST-INFO | 1660: exit 0 16:10:21 INFO - TEST-OK | dromaeo_css | took 1119307ms 16:10:21 INFO - TEST-START | kraken 16:10:21 INFO - operating with platform_type : mac_ 16:10:21 INFO - Initialising browser for kraken test... 16:10:21 INFO - TEST-INFO | started process 1668 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/tmpDkMt8g/profile http://localhost:49268/getInfo.html) 16:10:23 INFO - PROCESS | 1668 | __metrics Screen width/height:1600/1200 16:10:23 INFO - PROCESS | 1668 | colorDepth:24 16:10:23 INFO - PROCESS | 1668 | Browser inner width/height: 1024/689 16:10:23 INFO - PROCESS | 1668 | __metrics 16:10:23 INFO - PROCESS | 1668 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 16:10:23 INFO - PROCESS | 1668 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:10:24 INFO - TEST-INFO | 1668: exit 0 16:10:24 INFO - Browser initialized. 16:10:24 INFO - Running cycle 1/1 for kraken test... 16:10:24 INFO - TEST-INFO | started process 1669 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/tmpDkMt8g/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:10:36 INFO - PROCESS | 1669 | RSS: Main: 232177664 16:10:36 INFO - PROCESS | 1669 | 16:10:39 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-beat-detection) 16:10:40 INFO - PROCESS | 1669 | RSS: Main: 290996224 16:10:40 INFO - PROCESS | 1669 | 16:10:42 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-dft) 16:10:43 INFO - PROCESS | 1669 | RSS: Main: 287350784 16:10:43 INFO - PROCESS | 1669 | 16:10:46 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-fft) 16:10:47 INFO - PROCESS | 1669 | RSS: Main: 376414208 16:10:47 INFO - PROCESS | 1669 | 16:10:49 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-oscillator) 16:10:50 INFO - PROCESS | 1669 | RSS: Main: 278478848 16:10:50 INFO - PROCESS | 1669 | 16:10:52 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:10:52 INFO - PROCESS | 1669 | RSS: Main: 282836992 16:10:52 INFO - PROCESS | 1669 | 16:10:55 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-darkroom) 16:10:56 INFO - PROCESS | 1669 | RSS: Main: 321691648 16:10:56 INFO - PROCESS | 1669 | 16:10:59 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-desaturate) 16:10:59 INFO - PROCESS | 1669 | RSS: Main: 322117632 16:10:59 INFO - PROCESS | 1669 | 16:11:02 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49268/tests/kraken/driver.html?testName=json-parse-financial) 16:11:03 INFO - PROCESS | 1669 | RSS: Main: 320061440 16:11:03 INFO - PROCESS | 1669 | 16:11:04 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49268/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:11:05 INFO - PROCESS | 1669 | RSS: Main: 298680320 16:11:05 INFO - PROCESS | 1669 | 16:11:07 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:11:08 INFO - PROCESS | 1669 | RSS: Main: 304553984 16:11:08 INFO - PROCESS | 1669 | 16:11:10 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:11:10 INFO - PROCESS | 1669 | RSS: Main: 306176000 16:11:10 INFO - PROCESS | 1669 | 16:11:13 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:11:14 INFO - PROCESS | 1669 | RSS: Main: 314769408 16:11:14 INFO - PROCESS | 1669 | 16:11:17 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:11:18 INFO - PROCESS | 1669 | RSS: Main: 317067264 16:11:18 INFO - PROCESS | 1669 | 16:11:19 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49268/tests/kraken/driver.html?testName=ai-astar) 16:11:20 INFO - PROCESS | 1669 | RSS: Main: 360685568 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | __start_tp_report 16:11:20 INFO - PROCESS | 1669 | _x_x_mozilla_page_load 16:11:20 INFO - PROCESS | 1669 | _x_x_mozilla_page_load_details 16:11:20 INFO - PROCESS | 1669 | |i|pagename|runs| 16:11:20 INFO - PROCESS | 1669 | |0;ai-astar;131;169;151;113;113;113;114;114;111;124 16:11:20 INFO - PROCESS | 1669 | |1;audio-beat-detection;148;109;134;161;107;128;129;108;160;111 16:11:20 INFO - PROCESS | 1669 | |2;audio-dft;185;185;183;180;184;183;193;215;182;187 16:11:20 INFO - PROCESS | 1669 | |3;audio-fft;77;76;79;178;83;83;57;59;137;58 16:11:20 INFO - PROCESS | 1669 | |4;audio-oscillator;82;86;133;67;71;74;118;68;70;116 16:11:20 INFO - PROCESS | 1669 | |5;imaging-gaussian-blur;88;112;134;85;87;85;88;85;88;85 16:11:20 INFO - PROCESS | 1669 | |6;imaging-darkroom;93;94;94;96;94;94;94;128;149;94 16:11:20 INFO - PROCESS | 1669 | |7;imaging-desaturate;87;85;87;86;86;84;86;83;84;87 16:11:20 INFO - PROCESS | 1669 | |8;json-parse-financial;56;53;57;54;53;54;55;54;54;54 16:11:20 INFO - PROCESS | 1669 | |9;json-stringify-tinderbox;65;67;67;76;73;80;73;71;69;71 16:11:20 INFO - PROCESS | 1669 | |10;stanford-crypto-aes;84;88;86;83;88;85;83;88;83;89 16:11:20 INFO - PROCESS | 1669 | |11;stanford-crypto-ccm;139;141;138;147;151;129;146;151;251;155 16:11:20 INFO - PROCESS | 1669 | |12;stanford-crypto-pbkdf2;169;169;165;167;166;168;167;174;179;231 16:11:20 INFO - PROCESS | 1669 | |13;stanford-crypto-sha256-iterative;69;68;70;68;67;67;67;68;69;66 16:11:20 INFO - PROCESS | 1669 | __end_tp_report 16:11:20 INFO - PROCESS | 1669 | __start_cc_report 16:11:20 INFO - PROCESS | 1669 | _x_x_mozilla_cycle_collect,1975 16:11:20 INFO - PROCESS | 1669 | __end_cc_report 16:11:20 INFO - PROCESS | 1669 | __startTimestamp1473289880128__endTimestamp 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | ------- Summary: start ------- 16:11:20 INFO - PROCESS | 1669 | Number of tests: 14 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#0] ai-astar Cycles:10 Average:125.30 Median:119.00 stddev:19.77 (16.6%) stddev-sans-first:20.86 16:11:20 INFO - PROCESS | 1669 | Values: 131.0 169.0 151.0 113.0 113.0 113.0 114.0 114.0 111.0 124.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#1] audio-beat-detection Cycles:10 Average:129.50 Median:131.50 stddev:21.13 (16.1%) stddev-sans-first:21.33 16:11:20 INFO - PROCESS | 1669 | Values: 148.0 109.0 134.0 161.0 107.0 128.0 129.0 108.0 160.0 111.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#2] audio-dft Cycles:10 Average:187.70 Median:185.00 stddev:10.21 (5.5%) stddev-sans-first:10.78 16:11:20 INFO - PROCESS | 1669 | Values: 185.0 185.0 183.0 180.0 184.0 183.0 193.0 215.0 182.0 187.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#3] audio-fft Cycles:10 Average:88.70 Median:76.50 stddev:38.86 (50.8%) stddev-sans-first:40.99 16:11:20 INFO - PROCESS | 1669 | Values: 77.0 76.0 79.0 178.0 83.0 83.0 57.0 59.0 137.0 58.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#4] audio-oscillator Cycles:10 Average:88.50 Median:70.50 stddev:24.49 (34.7%) stddev-sans-first:25.86 16:11:20 INFO - PROCESS | 1669 | Values: 82.0 86.0 133.0 67.0 71.0 74.0 118.0 68.0 70.0 116.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#5] imaging-gaussian-blur Cycles:10 Average:93.70 Median:86.00 stddev:16.34 (19.0%) stddev-sans-first:17.20 16:11:20 INFO - PROCESS | 1669 | Values: 88.0 112.0 134.0 85.0 87.0 85.0 88.0 85.0 88.0 85.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#6] imaging-darkroom Cycles:10 Average:103.00 Median:94.00 stddev:19.37 (20.6%) stddev-sans-first:20.20 16:11:20 INFO - PROCESS | 1669 | Values: 93.0 94.0 94.0 96.0 94.0 94.0 94.0 128.0 149.0 94.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#7] imaging-desaturate Cycles:10 Average:85.50 Median:86.00 stddev:1.43 (1.7%) stddev-sans-first:1.41 16:11:20 INFO - PROCESS | 1669 | Values: 87.0 85.0 87.0 86.0 86.0 84.0 86.0 83.0 84.0 87.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#8] json-parse-financial Cycles:10 Average:54.40 Median:54.00 stddev:1.26 (2.3%) stddev-sans-first:1.20 16:11:20 INFO - PROCESS | 1669 | Values: 56.0 53.0 57.0 54.0 53.0 54.0 55.0 54.0 54.0 54.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#9] json-stringify-tinderbox Cycles:10 Average:71.20 Median:72.00 stddev:4.54 (6.3%) stddev-sans-first:4.23 16:11:20 INFO - PROCESS | 1669 | Values: 65.0 67.0 67.0 76.0 73.0 80.0 73.0 71.0 69.0 71.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#10] stanford-crypto-aes Cycles:10 Average:85.70 Median:87.00 stddev:2.41 (2.8%) stddev-sans-first:2.47 16:11:20 INFO - PROCESS | 1669 | Values: 84.0 88.0 86.0 83.0 88.0 85.0 83.0 88.0 83.0 89.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#11] stanford-crypto-ccm Cycles:10 Average:154.80 Median:149.00 stddev:34.66 (23.3%) stddev-sans-first:36.28 16:11:20 INFO - PROCESS | 1669 | Values: 139.0 141.0 138.0 147.0 151.0 129.0 146.0 151.0 251.0 155.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:175.50 Median:169.00 stddev:19.95 (11.8%) stddev-sans-first:21.02 16:11:20 INFO - PROCESS | 1669 | Values: 169.0 169.0 165.0 167.0 166.0 168.0 167.0 174.0 179.0 231.0 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - PROCESS | 1669 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.90 Median:68.00 stddev:1.20 (1.8%) stddev-sans-first:1.20 16:11:20 INFO - PROCESS | 1669 | Values: 69.0 68.0 70.0 68.0 67.0 67.0 67.0 68.0 69.0 66.0 16:11:20 INFO - PROCESS | 1669 | -------- Summary: end -------- 16:11:20 INFO - PROCESS | 1669 | 16:11:20 INFO - TEST-INFO | 1669: exit 0 16:11:20 INFO - TEST-OK | kraken | took 59436ms 16:11:20 INFO - SUITE-END | took 1178s 16:11:21 INFO - Completed test suite (00:19:39) 16:11:21 INFO - javascript benchmark 16:11:21 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3322.368749937512, 3333.200031992322, 3352.0781785009103, 3356.8153751543655, 3428.177237463008, 5609.915851262224, 5638.859028524289, 5664.1220610805285, 5686.147077938306, 5734.053881109622, 5722.656640601556, 5740.655560666363, 5759.366469688331, 5775.942240577593, 5781.306243250805, 4431.047324825162, 5221.060209162359, 5245.868853278679, 5283.498067683564, 5283.603729720267, 5330.333708286465, 5352.57179425645, 5356.38401583819, 5357.1696387060065, 5360.812371566996, 5246.003259380725, 5266.973665131688, 5302.840914772543, 5316.175992721134, 5359.410464848864, 5346.331708536452, 5353.063213937584, 5361.651492653004, 5363.704996225206, 5387.0, 5166.664166829144, 5173.741312934339, 5204.609654275944, 5289.233061206103, 5302.072137375943, 4767.904641907177, 5698.886022279573, 5733.082706766897, 5770.567207459458, 5815.621984571032, 6291.748330066792, 6295.622262664209, 6296.905546416808, 6306.873862522724, 6313.87372252557, 6177.722002509898, 6240.313565507836, 6251.468625166866, 6256.562040657156, 6302.716377763011, 5857.355690874, 5860.3260625027815, 5863.853403664943, 5893.351731309553, 5916.3787802281, 5690.146478028329, 6214.844628884314, 6280.340564240689, 6296.65368404733, 6311.0, 5884.08796636522, 5954.345022047572, 6039.0, 6183.96908015466, 6207.037909124093, 6253.0, 6265.530085243534, 6273.96863015682, 6294.716737746812, 6316.178896743486, 6236.314005459396, 6268.811935641938, 6281.120643109968, 6281.183446152062, 6308.684565771693, 4646.721196728207, 6146.293176284695, 6148.1085242640465, 6314.873702526015, 6324.146240257506, 4990.925136122961, 4992.975035124874, 4997.575206107522, 4999.675021123615, 5001.524855138756, 4437.489688685778, 4498.50516443191, 4504.81980720774, 4539.409876716006, 4552.2488789350045, 5710.486056254957, 5717.371089180187, 5718.170865224519, 5742.7415766290615, 5745.224394706661, 6319.747210111636, 6328.240611126695, 6331.9366806331345, 6343.080253363237, 6349.746010159634, 5608.327000759935, 5608.887822243532, 5684.8294551163535, 5711.600187986801, 5733.88532229353, 5488.039593071197, 5495.752691128909, 5501.642393244426, 5535.750891209906, 5554.166874968787, 6274.62352258875, 6324.841878953063, 6327.493800496041, 6330.936690633127, 6332.493400527855, 6064.120702498025, 6167.229096362955, 6316.968415158079, 6329.367063293634, 6341.651209183539, 5643.238162847963, 6287.497000239879, 6293.779717709858, 6294.118823364641, 6310.873782524415, 6199.814005579839, 6235.282942461675, 6249.9375006251175, 6256.31180570146, 6257.28041275241, 6104.398524058527, 6105.732692890381, 6310.432061114522, 6322.209723784527, 6330.556861019684, 5878.882422351615, 6013.9699301503215, 6076.392360764065, 6082.2093127893095, 6113.57204995646, 6059.272887253382, 6063.029915213545, 6065.636061836304, 6077.513798896166, 6080.939190608037, 5879.911801323069, 5884.117382392676, 5890.910181616415, 5893.734781934738, 5896.734646940984, 6043.09353596964, 6058.091286307089, 6061.15143879866, 6065.696715164136, 6087.847803804763, 5907.616004959664, 5934.139549765347, 5935.525157987437, 5936.257967754031, 5997.460228579449], "value": 5709.885818482277, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [518.3727689495709, 520.9557187639051, 531.7952588253523, 533.4452169743467, 554.1853475391174, 34462.827685861565, 40950.590494095086, 41272.793636031856, 41308.99999999996, 43206.35190472146, 43132.56867431325, 43439.3484097738, 43486.0, 43509.34735978955, 43512.56487435125, 8780.780480487974, 8924.464532128093, 9834.262430317736, 9993.650222242222, 10003.099721025106, 11938.820917686198, 12165.148439609187, 12183.269003859798, 12406.441710123021, 12417.689557761083, 12203.0, 12301.954333881631, 12303.015758739324, 12314.19957702751, 12314.630561083182, 10274.897251027469, 10337.638182663646, 12274.079444041732, 12302.384880755926, 12316.322602256918, 11975.101867359983, 12054.975327097207, 12056.578019769266, 12057.09571782111, 12067.456964436622, 40480.59519404798, 40775.77672669825, 40909.1818163635, 40916.0, 40933.79533102315, 3382.0868365541414, 3454.7063499602564, 3468.150303175738, 3570.5001299817786, 3818.7899665518385, 30290.69709302923, 31382.843085784654, 31652.683473165434, 31654.683453165402, 31971.84014079938, 3242.400155971153, 3279.2293810954407, 3295.1926777939557, 3330.601147518048, 3390.7117894978956, 512328.0, 514449.9999999963, 514920.0, 514993.0, 516035.0, 50884.745576272624, 53923.73038134863, 54018.0, 57962.7101864488, 59264.70367648134, 62101.68949155225, 62653.0, 63192.68403657952, 63199.736005279636, 63256.41858953471, 15347.769783453257, 15515.767263491056, 15522.689546209012, 15527.223638818014, 15528.922355388377, 10913.18151138652, 11059.557617695202, 11829.52681892732, 11887.227330223508, 12066.939665301617, 15901.761473577906, 15911.840881591268, 15943.282552284943, 15978.440754573534, 16035.438759643357, 6150.661713605795, 6173.41352571505, 6209.844753881189, 6215.968920155461, 6238.282597501346, 859.7420773767844, 914.7713071732067, 920.7513971227731, 927.1007123090726, 981.9754506137261, 27147.321316967234, 29928.102156935325, 30314.80838828012, 30536.236594085327, 30858.074257772303, 1004.5379125602304, 1052.273930987616, 1078.789636020984, 1108.3682301088463, 1157.7105723569107, 14878.479253226302, 15380.846191538165, 15572.305695602347, 15626.76559851603, 15758.527244182693, 658611.0, 660617.0, 661071.0, 661407.0, 662985.0, 58241.83516329734, 58268.708656456445, 58374.708126459096, 58379.41620583825, 58428.4157158423, 1224.8958838498827, 1338.2773302416585, 1358.9728205435836, 1381.7650999330137, 1386.0713322074032, 29952.95164669226, 30956.0713178605, 31064.22339441532, 31759.364812703156, 31889.043328700176, 48480.0, 55043.72478137584, 55997.16004260021, 56090.0, 58751.0, 608534.0, 613990.0, 614874.0, 615364.2331131977, 617606.0, 24379.26862194137, 24700.0, 24717.0, 25422.0, 25607.847646855564, 45158.77420612876, 45354.0, 45359.86600334886, 45964.77017614891, 45982.310265345375, 36861.07847303839, 37817.62182378141, 37967.24065518729, 39044.0238994016, 39315.0, 33735.662643374235, 35809.82095089508, 37533.249335013694, 37552.0, 38742.0, 37369.813150934075, 37532.624673754006, 37910.862674119824, 37938.43092353562, 38259.42610860783, 30905.227369315948, 33293.83353083219, 33718.0, 33753.81861634831, 34197.80307689219, 24383.0, 24966.0, 25288.494230114928, 25394.619080713434, 26904.596431053942], "value": 20261.83642666498, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [348.0862735319786, 362.1868904309825, 367.86756767563674, 376.19118894377084, 398.90426297688543, 14905.0, 15218.77171842422, 20410.489737756565, 20580.765154090765, 21035.477372364938, 19393.515162120955, 19823.0, 20082.899585502088, 20286.79713202871, 20423.48941276465, 5029.641996660899, 5413.783448662049, 5658.377578466366, 5661.971690141564, 5674.914876276859, 3435.7594968352223, 4157.251694694954, 6166.81499555014, 6207.782727604535, 6267.310595834455, 5919.1713160157615, 6135.202423684915, 6183.6598987055695, 6220.377962203788, 6221.59559628625, 6002.099685047234, 6115.296740874767, 6142.659279778376, 6185.969070154621, 6196.628202307876, 6025.0, 6027.216461859974, 6034.879302413927, 6041.848953776147, 6042.214512113397, 16779.66440671192, 24152.03391864341, 24438.14466493682, 24806.131785387606, 25489.872550637312, 2122.4587730128874, 2130.648443006902, 2135.9145634174615, 2177.2162021672184, 2211.800937915579, 9872.765904261967, 10328.896711032869, 10349.844752328721, 13012.804807927794, 14894.0, 1433.9928300358536, 1868.6075924055829, 1873.7751469823572, 1874.3627166763229, 1884.510027392874, 126703.36648316792, 128911.0, 130798.0, 131383.0, 131513.34243328817, 9285.907140928639, 11483.25358851672, 11506.928752824404, 11525.193236473535, 11684.532618695326, 14568.927155364367, 14582.979191456496, 14600.780988285183, 14613.19627420502, 14615.050021748764, 8150.2664760171865, 8471.19523645265, 8475.110113438124, 8564.357673174412, 8575.528345940907, 8284.751457456287, 8285.461445006054, 8288.958555207186, 8451.661933522713, 8493.575321233913, 3859.1316953685196, 4492.9550704493195, 4509.1658043262105, 4521.570450807168, 4528.479224889114, 1631.5757902945081, 1773.5388798912375, 1856.5729882127187, 1934.9489541086493, 1953.9218431262875, 701.8105111619936, 797.8723404255292, 860.1355637584188, 879.3800370738614, 936.2118353943935, 16582.17089145538, 19385.321513746952, 19935.800641993683, 20907.0, 21145.0, 859.072202021815, 969.3699095587924, 986.1519093579516, 986.6102889358807, 1023.9283250172416, 10127.240456965757, 10387.84418233727, 10705.9464702676, 10815.459227038775, 11011.28426652265, 613402.0, 622599.887000562, 626258.0, 627113.0, 629922.0, 130955.0, 132205.0, 133000.0, 134439.0, 142260.28869855584, 962.5620342744035, 999.2056315229265, 1012.4026824173773, 1013.6452241715488, 1019.5208252121491, 14517.85482145165, 16821.0, 18658.53353666115, 18678.53303667419, 18724.0, 55884.72057639686, 56144.0, 57292.71353643205, 57322.7133864328, 58967.0, 68542.83614841971, 83080.0, 85997.0, 86416.46961190467, 88552.0, 6091.786787462417, 7914.525128492309, 8119.188081191834, 8154.75535733929, 8282.834343313221, 10773.838392423962, 11055.94472027667, 12206.694832629255, 12861.549845755353, 12865.549705760253, 10764.569417223223, 10908.40003799767, 11009.669709908716, 11130.499127539118, 11196.888031119584, 10769.838452423062, 10856.891431085904, 10910.727231819268, 11032.503537341, 11167.939045790637, 11173.0, 11247.381394023407, 11255.549778008788, 11283.548658053585, 11385.0, 7882.448228623941, 7903.723369682033, 8308.916910831056, 8381.245687888118, 8408.957955210184, 10061.849072263776, 11121.110311175249, 11312.490937907649, 11489.712757181138, 11563.248388854698], "value": 9481.528159213784, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1378.9310534473275, 1444.4511085787399, 1520.847915208479, 1864.0959134819602, 1914.387396033269, 8513.702020429278, 9043.593038313275, 9058.0, 9059.592318345674, 9065.365424420293, 7830.2561256680665, 8091.554964476966, 8556.74329770108, 8780.824383512327, 8886.955565222164, 2398.5322862041867, 2435.695538057743, 2437.5368679950843, 2439.890204940782, 2444.9144279950206, 2149.892505374733, 2313.669639957023, 2397.652340410639, 2419.4798118404537, 2433.610622300432, 2207.558488302346, 2300.5621486570894, 2390.115657206827, 2393.9880300598475, 2399.78401943825, 2382.833201675883, 2394.174009966559, 2403.305669503005, 2406.6750988616486, 2416.6979127609047, 2398.988005059981, 2399.3281881073326, 2409.0968135173366, 2411.565918134735, 2412.2039726890084, 8871.911280887238, 8919.598618062202, 8953.731388058304, 8965.058668839809, 8975.820483590292, 5297.549708274802, 5447.291852059247, 5448.700321482317, 5455.754491047873, 5461.1262198048125, 3603.1352475405974, 3617.4935509028755, 3667.3948798448223, 3690.7231957603285, 3701.5188025556777, 953.9379940303858, 954.0650162840386, 958.6213445688984, 969.961201551937, 975.4196253229317, 11487.368194749286, 11615.186936914419, 11616.36110013949, 11706.180567360203, 11745.29528228309, 4247.895547157761, 4586.839460618862, 4632.907341853144, 4720.905581888343, 4811.350467686818, 10022.248331375176, 10023.949880250551, 10029.648962286285, 10032.598696052222, 10040.246981476419, 5397.325334333208, 5414.566834653218, 5423.83728488146, 5430.402655707869, 5451.373092094381, 4097.262492751273, 4367.27939889921, 4441.511433742286, 4586.105709386704, 4972.0801651694555, 3523.436250199956, 3902.35611124167, 3906.902327441837, 3931.331673615492, 4123.8556650517085, 1033.3851358441866, 1291.115585823695, 1299.5191779041816, 1301.7071158989152, 1316.2431601828987, 794.5788731972063, 866.6360128745941, 896.2919293757858, 917.1378903830378, 936.3164889630608, 5732.312122545238, 5817.272840894888, 6030.879382412327, 6039.698015099228, 6280.717367718464, 910.2717825739514, 935.4434111703525, 938.8685584018243, 940.2759874896428, 983.4640121133999, 3823.7323387363176, 3845.2309538092495, 3945.6251656092627, 3964.0882597002274, 3996.5603783583783, 10120.898791011996, 10857.45712714361, 10953.068989136013, 10990.395528246023, 11006.449677516091, 10497.002784735438, 10836.0, 10905.890941090645, 10918.781624367468, 10921.781564368668, 8065.233802788725, 8105.067917189481, 8277.751667449986, 8302.54336011513, 8325.042620098646, 5612.438756124355, 5670.0, 5778.479936805707, 5833.970830145992, 5834.591578589458, 10073.244506661884, 10093.949530252301, 10095.141912937188, 10130.89869101329, 10159.288849780445, 8797.0, 9692.369995950523, 9774.902250977399, 10271.383716977005, 10276.537555810157, 6918.688659010256, 7126.251743566851, 7143.6428178591905, 7425.146108197627, 7628.970089037909, 7921.841563168819, 7997.800054998672, 8111.269985701315, 8386.329093672613, 8401.53791541471, 7377.409807215303, 7570.9242907570215, 7577.583232922242, 7642.923570764221, 7696.46124771283, 7282.960770984133, 7420.5547667140145, 7445.181030086578, 7483.550986940801, 7583.090029196532, 6923.099997000358, 7048.471364647775, 7056.576605403692, 7058.611776352144, 7081.539699919489, 4765.428148622187, 4877.195262781602, 4997.1754660482065, 5082.161443361804, 5121.231815227597, 4916.459189489225, 4957.856234096612, 5076.18780995039, 5135.486451354835, 5253.973730131325], "value": 4583.90529695283, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [299.77067543329355, 303.2676087249293, 309.38432519286624, 312.9702678245566, 315.62125449460655, 4906.828261010865, 5093.821716239937, 5350.512011914459, 5441.646292990953, 5449.591280653947, 4222.598853108957, 4674.0, 4927.014597080589, 5043.092243396187, 5074.822381216658, 3305.2893627870003, 3886.0, 4021.9798901005456, 4024.9597504025023, 4133.3386658134705, 3630.80030598317, 4076.429299898017, 4094.324436467979, 4106.568810274923, 4141.420201171838, 3811.485449464328, 3939.1289137659523, 4027.677785777131, 4044.4337792709043, 4077.5718549552316, 4005.6595189408645, 4021.4973128358956, 4051.176970363348, 4064.979675101635, 4077.2049450357194, 3499.9825000874835, 3509.4209455439823, 3519.1729943463265, 3529.5588051493564, 3539.3983022886173, 4172.666186705056, 4982.850514484571, 5193.428722840485, 5212.322398088262, 5246.580273578104, 4626.86119416418, 4664.463586687541, 4680.017196388762, 4681.578657920803, 4681.9297710534365, 4712.740799256039, 4725.149473094842, 5375.0, 5422.620416570841, 5610.438956104357, 3363.798172109681, 3711.9628803712158, 3888.5333759948703, 3897.337452633059, 3936.940945885814, 4906.435759887623, 5227.849873027966, 5659.745311460994, 5893.911591326134, 5987.191729116601, 3919.6080391960577, 3927.8625248116177, 3938.783366914847, 3954.703397245218, 3978.462907507507, 3403.8808641697424, 3729.4266955800413, 3734.981325093357, 4027.81874815634, 4057.127717540743, 4360.629346505519, 4648.279516674921, 4667.883302917454, 4671.509491503343, 4672.766361681903, 5613.298337707786, 5625.959197548466, 5628.774849006076, 5640.689762063043, 5661.830145095653, 1232.3099064523717, 1262.6022802817083, 1337.525178561616, 1367.6444124527695, 1379.537854818647, 838.3167718309559, 872.1975782280317, 899.8020435504178, 921.3964853021282, 948.8339540580508, 5152.660308319864, 5160.8967820643375, 5187.158558711679, 5196.298499702491, 5220.582353411718, 4550.544945505423, 4832.661713680079, 5725.770969161187, 5747.540196784247, 5815.88368232633, 4469.7318160910445, 4541.523140070245, 4852.8544143675745, 5015.749212539358, 5127.0260949534695, 2393.5452264069772, 2563.9871800640876, 2805.845678487662, 3014.6033903047132, 3019.879204831826, 4938.185199442052, 5020.0, 5124.052050370693, 5466.9179962300595, 5787.971060144672, 5122.9743851281255, 5371.791346946984, 5839.912401313899, 5859.619124756877, 5884.382139875337, 5920.378360272195, 5922.407759224129, 5940.524758019348, 5957.582969192115, 5965.373635768268, 4525.434320709911, 5174.826572839341, 5710.2291190690385, 5728.4769866532615, 5868.501177399969, 4837.564619184291, 5766.933117373132, 5858.455634341332, 5861.35525092248, 5868.129452554455, 5239.607029472881, 5510.068488702669, 6140.267580926445, 6140.5701600887505, 6177.938220617916, 3537.8407971640822, 3599.964000359963, 3768.4158955361963, 3852.788096654711, 3900.893517500518, 5798.69474399605, 5828.883422331445, 5832.24180856486, 5842.444967728059, 5850.648961062179, 5668.121441176624, 5668.546516278605, 5671.829845104653, 5700.287464066992, 5726.255586773693, 4844.975775121102, 5174.249733788655, 5331.4805280494875, 5686.004949133968, 5705.0, 4898.559129678346, 5320.441353657965, 5603.299587551556, 5605.831825045255, 5622.522085622604, 5170.224466330081, 5314.468553144655, 5573.860653483695, 5693.1460280956535, 5765.827025189251, 4690.390249267573, 5528.175702018405, 5553.72231388437, 5593.300837395325, 5604.719764011702], "value": 4078.2655564924503, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [715.2204097533688, 728.8141523911405, 760.615888976067, 799.9960000199998, 818.8567000774866, 14817.481388151416, 16192.919035404835, 16206.946548474356, 16209.513714588551, 16238.025718456885, 14600.26998650066, 14747.410103595843, 14752.704945901076, 14786.0, 14804.333804978774, 675.8884784010656, 689.8896176611743, 847.516915358246, 852.0840096895831, 863.3050394432479, 837.5184269045324, 851.2934264560431, 851.8296340731847, 853.1340689200466, 853.2619284319081, 875.5665945357025, 893.7586851550078, 895.8611415230617, 896.4128495835206, 900.3472482450237, 712.4905692429937, 878.7232021913077, 886.6896586194845, 893.2675206330812, 893.271983333581, 666.040901102411, 667.0594461808827, 668.0446960845989, 668.4585485756553, 669.6819010969799, 14066.859331406657, 14084.577462676034, 14106.85893141076, 14131.010829241957, 14209.78685319721, 13533.120347177402, 13684.110532815435, 13842.0, 13928.233947132903, 14225.217613031278, 12653.177543459738, 12852.614421567274, 12887.0, 13106.541271055563, 13146.671333216651, 4476.6418686505, 4578.084383123389, 4626.0, 4628.282616194461, 4650.279206722963, 125341.0, 129805.0, 131086.0, 131087.34456327753, 132281.33859330643, 10449.477526123663, 10989.0, 11008.724781880357, 11269.323840569592, 11459.255148415326, 21364.0, 21545.353639390843, 21681.241156559445, 21743.673844892022, 21772.782272177075, 7835.022691377354, 7877.842443151105, 7928.405369597303, 8123.309518690978, 8130.634121464548, 4453.866384008485, 4465.866024019285, 4499.6400287976885, 4601.585857272861, 4673.065386922561, 3394.4908263760635, 3495.3883070462566, 3506.193575477603, 3506.982465087658, 3507.035565219585, 606.3905774696402, 606.5905513778271, 643.5077165968038, 651.5569412799342, 660.2638058564762, 518.429727299967, 527.5463101732507, 540.8318033048596, 567.619694804482, 578.3695771608882, 8293.751187464386, 8623.827523449496, 8743.81228221468, 8795.604197811113, 9007.459552426875, 578.3506076656312, 590.4508806809708, 606.2028432611103, 615.7321565119188, 617.5677026081761, 3397.490376443504, 4229.407882896397, 4361.127774445124, 4426.645868330525, 4463.375127482155, 110569.44715276372, 110865.0, 137435.0, 151580.72628910575, 164195.0, 138810.3059484696, 139601.30199348938, 140485.0, 142592.0, 150881.24559377134, 123688.38155809163, 124127.0, 125825.0, 127714.36142819226, 128458.71541284655, 6681.864083105981, 8400.327973761961, 8447.366447516339, 8503.702370417006, 8596.226339629464, 61032.38967610267, 64747.0, 65098.0, 66438.0, 66728.0, 78653.60673196598, 93364.06635933554, 95292.0, 98068.0, 100385.0, 11618.941905290758, 11644.941775291069, 11801.409929503663, 11852.111091667986, 11970.401479925795, 12204.938975305422, 12205.450754716237, 12329.260244385365, 12702.174358666656, 12707.237565746085, 11762.411879406167, 11938.28370297785, 11938.880611193777, 11974.161808673309, 12251.75496490083, 11510.424733573542, 11659.591914282959, 11818.940905295418, 12209.206401583868, 12316.199447035913, 10839.891601083888, 11005.284656497302, 11086.667399978014, 11569.479373428385, 12259.570915017932, 8646.875906132163, 9639.71080867575, 9799.069088436587, 9874.30879838433, 9877.95061024719, 8007.599620019092, 9911.504424778876, 9934.40015902986, 9958.651447199314, 9988.740470320936], "value": 7612.590775877814, "unit": "score"}], "name": "dromaeo_css", "value": 7338.023682587724, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 169.0, 151.0, 113.0, 113.0, 113.0, 114.0, 114.0, 111.0, 124.0], "value": 125.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 109.0, 134.0, 161.0, 107.0, 128.0, 129.0, 108.0, 160.0, 111.0], "value": 129.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [185.0, 185.0, 183.0, 180.0, 184.0, 183.0, 193.0, 215.0, 182.0, 187.0], "value": 187.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 76.0, 79.0, 178.0, 83.0, 83.0, 57.0, 59.0, 137.0, 58.0], "value": 88.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 86.0, 133.0, 67.0, 71.0, 74.0, 118.0, 68.0, 70.0, 116.0], "value": 88.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 112.0, 134.0, 85.0, 87.0, 85.0, 88.0, 85.0, 88.0, 85.0], "value": 93.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 94.0, 94.0, 96.0, 94.0, 94.0, 94.0, 128.0, 149.0, 94.0], "value": 103.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 85.0, 87.0, 86.0, 86.0, 84.0, 86.0, 83.0, 84.0, 87.0], "value": 85.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 53.0, 57.0, 54.0, 53.0, 54.0, 55.0, 54.0, 54.0, 54.0], "value": 54.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 67.0, 67.0, 76.0, 73.0, 80.0, 73.0, 71.0, 69.0, 71.0], "value": 71.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 88.0, 86.0, 83.0, 88.0, 85.0, 83.0, 88.0, 83.0, 89.0], "value": 85.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 141.0, 138.0, 147.0, 151.0, 129.0, 146.0, 151.0, 251.0, 155.0], "value": 154.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 169.0, 165.0, 167.0, 166.0, 168.0, 167.0, 174.0, 179.0, 231.0], "value": 175.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 68.0, 70.0, 68.0, 67.0, 67.0, 67.0, 68.0, 69.0, 66.0], "value": 67.9, "unit": "score"}], "name": "kraken", "value": 1511.4, "alertThreshold": 2.0}]} 16:11:21 INFO - Return code: 0 16:11:21 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:11:21 INFO - # TBPL SUCCESS # 16:11:21 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:11:21 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:11:21 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:11:21 INFO - 2016-09-07 16:11:21.464 screenresolution[1673:11606] starting screenresolution argv=screenresolution get 16:11:21 INFO - 2016-09-07 16:11:21.467 screenresolution[1673:11606] Display 0: 1600x1200x32@60 16:11:21 INFO - 2016-09-07 16:11:21.473 screenresolution[1674:11609] starting screenresolution argv=screenresolution list 16:11:21 INFO - Available Modes on Display 0 16:11:21 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:11:21 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:11:21 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:11:21 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:11:21 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:11:21 INFO - Intel Iris: 16:11:21 INFO - Chipset Model: Intel Iris 16:11:21 INFO - Type: GPU 16:11:21 INFO - Bus: Built-In 16:11:21 INFO - VRAM (Dynamic, Max): 1536 MB 16:11:21 INFO - Vendor: Intel (0x8086) 16:11:21 INFO - Device ID: 0x0a2e 16:11:21 INFO - Revision ID: 0x0009 16:11:21 INFO - Displays: 16:11:21 INFO - Display: 16:11:21 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:11:21 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:11:21 INFO - Display Serial Number: 1600x1200 60 16:11:21 INFO - Main Display: Yes 16:11:21 INFO - Mirror: Off 16:11:21 INFO - Online: Yes 16:11:21 INFO - Rotation: Supported 16:11:21 INFO - Return code: 0 16:11:21 INFO - Running post-action listener: _resource_record_post_action 16:11:21 INFO - [mozharness: 2016-09-07 23:11:21.716917Z] Finished run-tests step (success) 16:11:21 INFO - Running post-run listener: _resource_record_post_run 16:11:21 INFO - Total resource usage - Wall time: 1214s; CPU: 54.0%; Read bytes: 32095232; Write bytes: 708128256; Read time: 196; Write time: 1981 16:11:21 INFO - TinderboxPrint: CPU usage
53.6% 16:11:21 INFO - TinderboxPrint: I/O read bytes / time
32,095,232 / 196 16:11:21 INFO - TinderboxPrint: I/O write bytes / time
708,128,256 / 1,981 16:11:21 INFO - TinderboxPrint: CPU idle
2,255.3 (46.4%) 16:11:21 INFO - TinderboxPrint: CPU system
974.4 (20.1%) 16:11:21 INFO - TinderboxPrint: CPU user
1,628.0 (33.5%) 16:11:21 INFO - TinderboxPrint: Swap in / out
434,610,176 / 0 16:11:21 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 396364288; Write bytes: 390018560; Read time: 29260; Write time: 801 16:11:21 INFO - run-tests - Wall time: 1180s; CPU: 54.0%; Read bytes: 30129152; Write bytes: 299345920; Read time: 180; Write time: 1136 16:11:22 INFO - Running post-run listener: _upload_blobber_files 16:11:22 INFO - Blob upload gear active. 16:11:22 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:11:22 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 16:11:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:11:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:11:22 INFO - (blobuploader) - INFO - Open directory for files ... 16:11:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 16:11:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:11:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:11:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 16:11:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:11:23 INFO - (blobuploader) - INFO - Done attempting. 16:11:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 16:11:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:11:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:11:24 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 16:11:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:11:24 INFO - (blobuploader) - INFO - Done attempting. 16:11:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:11:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:11:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:11:27 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:11:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:11:27 INFO - (blobuploader) - INFO - Done attempting. 16:11:27 INFO - (blobuploader) - INFO - Iteration through files over. 16:11:27 INFO - Return code: 0 16:11:27 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:11:27 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:11:27 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/00850f3c89ca672803e63720d189da1dcc9a6f892cfce24f819799af31a3398ad7c18e6fca623eb404fb20330e3694dec5184f346bd591493e83193f98f90d8a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f1864c8a19ad2600dfb5c2540488019b64e141038fecdc74b27f4222381264bcd1b5528186d04d8d4913a4695048768410e0bd694a1cd91efaf187ab14a20120", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/53e5e24ca375f0bad78450260a30d7769d29d822ad307b01a860214fd45878a3e501a2748de10f1b10544b3e522f447b433f07944530b3dd618ba362d9c6f350"} 16:11:27 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:11:27 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:11:27 INFO - Contents: 16:11:27 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/00850f3c89ca672803e63720d189da1dcc9a6f892cfce24f819799af31a3398ad7c18e6fca623eb404fb20330e3694dec5184f346bd591493e83193f98f90d8a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f1864c8a19ad2600dfb5c2540488019b64e141038fecdc74b27f4222381264bcd1b5528186d04d8d4913a4695048768410e0bd694a1cd91efaf187ab14a20120", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/53e5e24ca375f0bad78450260a30d7769d29d822ad307b01a860214fd45878a3e501a2748de10f1b10544b3e522f447b433f07944530b3dd618ba362d9c6f350"} 16:11:27 INFO - Running post-run listener: copy_logs_to_upload_dir 16:11:27 INFO - Copying logs to upload dir... 16:11:27 INFO - mkdir: /builds/slave/test/build/upload/logs 16:11:27 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1335.036435 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 15 secs) (at 2016-09-07 16:11:27.125744) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-07 16:11:27.129629) ========= 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.AQbPoEoF21/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.xueSlZnyuT/Listeners TMPDIR=/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/00850f3c89ca672803e63720d189da1dcc9a6f892cfce24f819799af31a3398ad7c18e6fca623eb404fb20330e3694dec5184f346bd591493e83193f98f90d8a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f1864c8a19ad2600dfb5c2540488019b64e141038fecdc74b27f4222381264bcd1b5528186d04d8d4913a4695048768410e0bd694a1cd91efaf187ab14a20120", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/53e5e24ca375f0bad78450260a30d7769d29d822ad307b01a860214fd45878a3e501a2748de10f1b10544b3e522f447b433f07944530b3dd618ba362d9c6f350"} build_url:https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010980 build_url: 'https://queue.taskcluster.net/v1/task/VnycP6VPQXOVdjc1W_JLew/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/00850f3c89ca672803e63720d189da1dcc9a6f892cfce24f819799af31a3398ad7c18e6fca623eb404fb20330e3694dec5184f346bd591493e83193f98f90d8a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f1864c8a19ad2600dfb5c2540488019b64e141038fecdc74b27f4222381264bcd1b5528186d04d8d4913a4695048768410e0bd694a1cd91efaf187ab14a20120", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/53e5e24ca375f0bad78450260a30d7769d29d822ad307b01a860214fd45878a3e501a2748de10f1b10544b3e522f447b433f07944530b3dd618ba362d9c6f350"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-07 16:11:27.164762) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-07 16:11:27.165084) ========= 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.AQbPoEoF21/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.xueSlZnyuT/Listeners TMPDIR=/var/folders/nm/b01fmtbx5f59cgm2djktykb800000w/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.005031 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-07 16:11:27.215498) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-07 16:11:27.215812) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-07 16:11:27.216134) ========= ========= Total master_lag: 0.17 =========