builder: mozilla-central_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0029 starttime: 1471043626.9 results: success (0) buildid: 20160812134617 builduid: f1bf0f41c12c4a5fbe0f641770a1593f revision: ef3a50774180e1ccc1b6d210295db8275739b92e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:46.900089) ========= master: http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:46.900651) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:46.901092) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:47.121438) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:47.121829) ========= 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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners TMPDIR=/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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-08-12 16:13:47-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 10.9M=0.001s 2016-08-12 16:13:47 (10.9 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.223305 ========= master_lag: 0.06 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:47.404177) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:47.404494) ========= 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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners TMPDIR=/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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.020555 ========= master_lag: 0.12 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:47.540979) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-12 16:13:47.541319) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev ef3a50774180e1ccc1b6d210295db8275739b92e --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev ef3a50774180e1ccc1b6d210295db8275739b92e --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners TMPDIR=/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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-08-12 16:13:47,645 truncating revision to first 12 chars 2016-08-12 16:13:47,646 Setting DEBUG logging. 2016-08-12 16:13:47,646 attempt 1/10 2016-08-12 16:13:47,646 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/ef3a50774180?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-12 16:13:48,550 unpacking tar archive at: mozilla-central-ef3a50774180/testing/mozharness/ program finished with exit code 0 elapsedTime=1.159617 ========= master_lag: 0.07 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-12 16:13:48.765947) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:48.766261) ========= script_repo_revision: ef3a50774180e1ccc1b6d210295db8275739b92e ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:48.766646) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:48.766908) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-12 16:13:48.943093) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 12 secs) (at 2016-08-12 16:13:48.943484) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners TMPDIR=/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:13:49 INFO - MultiFileLogger online at 20160812 16:13:49 in /builds/slave/test 16:13:49 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 16:13:49 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:13:49 INFO - {'append_to_log': False, 16:13:49 INFO - 'base_work_dir': '/builds/slave/test', 16:13:49 INFO - 'blob_upload_branch': 'Firefox', 16:13:49 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:13:49 INFO - 'branch': 'Firefox', 16:13:49 INFO - 'buildbot_json_path': 'buildprops.json', 16:13:49 INFO - 'config_files': ('talos/mac_config.py',), 16:13:49 INFO - 'default_actions': ('clobber', 16:13:49 INFO - 'read-buildbot-config', 16:13:49 INFO - 'download-and-extract', 16:13:49 INFO - 'populate-webroot', 16:13:49 INFO - 'create-virtualenv', 16:13:49 INFO - 'install', 16:13:49 INFO - 'run-tests'), 16:13:49 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:13:49 INFO - 'download_minidump_stackwalk': True, 16:13:49 INFO - 'download_symbols': 'ondemand', 16:13:49 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:13:49 INFO - 'tooltool.py': '/tools/tooltool.py', 16:13:49 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:13:49 INFO - '/tools/misc-python/virtualenv.py')}, 16:13:49 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:13:49 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:13:49 INFO - 'installer_path': 'installer.exe', 16:13:49 INFO - 'log_level': 'info', 16:13:49 INFO - 'log_name': 'talos', 16:13:49 INFO - 'log_to_console': True, 16:13:49 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 16:13:49 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 16:13:49 INFO - 'opt_config_files': (), 16:13:49 INFO - 'pip_index': False, 16:13:49 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 16:13:49 INFO - 'cmd': ('bash', 16:13:49 INFO - '-c', 16:13:49 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 16:13:49 INFO - 'enabled': True, 16:13:49 INFO - 'halt_on_failure': False, 16:13:49 INFO - 'name': 'check_screen_resolution'},), 16:13:49 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 16:13:49 INFO - 'cmd': ('bash', 16:13:49 INFO - '-c', 16:13:49 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 16:13:49 INFO - 'enabled': True, 16:13:49 INFO - 'halt_on_failure': False, 16:13:49 INFO - 'name': 'check_screen_resolution'},), 16:13:49 INFO - 'run_cmd_checks_enabled': True, 16:13:49 INFO - 'sps_profile': False, 16:13:49 INFO - 'sps_profile_interval': 0, 16:13:49 INFO - 'suite': 'dromaeojs-e10s', 16:13:49 INFO - 'system_bits': '32', 16:13:49 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:13:49 INFO - 'title': 't-yosemite-r7-0029', 16:13:49 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:13:49 INFO - 'use_talos_json': True, 16:13:49 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:13:49 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:13:49 INFO - 'work_dir': 'build'} 16:13:49 INFO - [mozharness: 2016-08-12 23:13:49.152809Z] Running clobber step. 16:13:49 INFO - Running pre-action listener: _resource_record_pre_action 16:13:49 INFO - Running main action method: clobber 16:13:49 INFO - rmtree: /builds/slave/test/build 16:13:49 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:13:50 INFO - Running post-action listener: _resource_record_post_action 16:13:50 INFO - [mozharness: 2016-08-12 23:13:50.949187Z] Finished clobber step (success) 16:13:50 INFO - [mozharness: 2016-08-12 23:13:50.949327Z] Running read-buildbot-config step. 16:13:50 INFO - Running pre-action listener: _resource_record_pre_action 16:13:50 INFO - Running main action method: read_buildbot_config 16:13:50 INFO - Using buildbot properties: 16:13:50 INFO - { 16:13:50 INFO - "project": "", 16:13:50 INFO - "product": "firefox", 16:13:50 INFO - "script_repo_revision": "production", 16:13:50 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs-e10s", 16:13:50 INFO - "repository": "", 16:13:50 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs-e10s", 16:13:50 INFO - "buildid": "20160812134617", 16:13:50 INFO - "pgo_build": "False", 16:13:50 INFO - "basedir": "/builds/slave/test", 16:13:50 INFO - "buildnumber": 40, 16:13:50 INFO - "slavename": "t-yosemite-r7-0029", 16:13:50 INFO - "master": "http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/", 16:13:50 INFO - "platform": "yosemite_r7", 16:13:50 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 16:13:50 INFO - "branch": "mozilla-central", 16:13:50 INFO - "repo_path": "mozilla-central", 16:13:50 INFO - "revision": "ef3a50774180e1ccc1b6d210295db8275739b92e", 16:13:50 INFO - "stage_platform": "macosx64", 16:13:50 INFO - "builduid": "f1bf0f41c12c4a5fbe0f641770a1593f", 16:13:50 INFO - "slavebuilddir": "test" 16:13:50 INFO - } 16:13:50 INFO - Found installer url https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg. 16:13:50 INFO - Running post-action listener: _resource_record_post_action 16:13:50 INFO - [mozharness: 2016-08-12 23:13:50.952667Z] Finished read-buildbot-config step (success) 16:13:50 INFO - [mozharness: 2016-08-12 23:13:50.952779Z] Running download-and-extract step. 16:13:50 INFO - Running pre-action listener: _resource_record_pre_action 16:13:50 INFO - Running main action method: download_and_extract 16:13:50 INFO - mkdir: /builds/slave/test/build/tests 16:13:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:13:50 INFO - trying https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json 16:13:50 INFO - Downloading https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/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 16:13:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/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 16:13:52 INFO - Downloaded 1199 bytes. 16:13:52 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 16:13:52 INFO - Using the following test package requirements: 16:13:52 INFO - {u'common': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 16:13:52 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 16:13:52 INFO - u'firefox-51.0a1.en-US.mac.cppunittest.tests.zip'], 16:13:52 INFO - u'gtest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 16:13:52 INFO - u'firefox-51.0a1.en-US.mac.gtest.tests.zip'], 16:13:52 INFO - u'jittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 16:13:52 INFO - u'jsshell-mac.zip'], 16:13:52 INFO - u'mochitest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 16:13:52 INFO - u'firefox-51.0a1.en-US.mac.mochitest.tests.zip'], 16:13:52 INFO - u'mozbase': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 16:13:52 INFO - u'reftest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 16:13:52 INFO - u'firefox-51.0a1.en-US.mac.reftest.tests.zip'], 16:13:52 INFO - u'talos': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 16:13:52 INFO - u'firefox-51.0a1.en-US.mac.talos.tests.zip'], 16:13:52 INFO - u'web-platform': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 16:13:52 INFO - u'firefox-51.0a1.en-US.mac.web-platform.tests.zip'], 16:13:52 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 16:13:52 INFO - u'firefox-51.0a1.en-US.mac.xpcshell.tests.zip']} 16:13:52 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip'] for test suite category: common 16:13:52 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')]} 16:13:52 INFO - trying https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 16:13:52 INFO - Downloading https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip 16:13:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip'}, attempt #1 16:13:53 INFO - Downloaded 16330441 bytes. 16:13:53 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 16:14:00 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 16:14:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:14:00 INFO - trying https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 16:14:00 INFO - Downloading https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip 16:14:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip'}, attempt #1 16:14:01 INFO - Downloaded 16330441 bytes. 16:14:01 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 16:14:08 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')]} 16:14:08 INFO - trying https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip 16:14:08 INFO - Downloading https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip 16:14:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip'}, attempt #1 16:14:10 INFO - Downloaded 14413719 bytes. 16:14:10 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/tests 16:14:10 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')]} 16:14:10 INFO - trying https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 16:14:10 INFO - Downloading https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg 16:14:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/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 16:14:14 INFO - Downloaded 111051856 bytes. 16:14:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 16:14:14 INFO - mkdir: /builds/slave/test/properties 16:14:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:14:14 INFO - Writing to file /builds/slave/test/properties/build_url 16:14:14 INFO - Contents: 16:14:14 INFO - build_url:https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 16:14:15 INFO - Running post-action listener: _resource_record_post_action 16:14:15 INFO - Running post-action listener: set_extra_try_arguments 16:14:15 INFO - [mozharness: 2016-08-12 23:14:15.148075Z] Finished download-and-extract step (success) 16:14:15 INFO - [mozharness: 2016-08-12 23:14:15.148217Z] Running populate-webroot step. 16:14:15 INFO - Running pre-action listener: _resource_record_pre_action 16:14:15 INFO - Running main action method: populate_webroot 16:14:15 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:14:15 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:14:15 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:14:15 INFO - '--tppagecycles', 16:14:15 INFO - '7'], 16:14:15 INFO - 'tests': ['tsvgm']}}, 16:14:15 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:14:15 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:14:15 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:14:15 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:14:15 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:14:15 INFO - 'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:14:15 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:14:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:14:15 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:14:15 INFO - 'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['damp', 'tps']}, 16:14:15 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:14:15 INFO - 'tests': ['damp', 'tps']}, 16:14:15 INFO - 'g3': {'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['dromaeo_dom']}, 16:14:15 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:14:15 INFO - 'g4': {'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['basic_compositor_video']}, 16:14:15 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 16:14:15 INFO - 'other': {'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['a11yr', 16:14:15 INFO - 'ts_paint', 16:14:15 INFO - 'tpaint', 16:14:15 INFO - 'sessionrestore', 16:14:15 INFO - 'sessionrestore_no_auto_restore', 16:14:15 INFO - 'tabpaint']}, 16:14:15 INFO - 'other-e10s': {'tests': ['a11yr', 16:14:15 INFO - 'ts_paint', 16:14:15 INFO - 'tpaint', 16:14:15 INFO - 'sessionrestore', 16:14:15 INFO - 'sessionrestore_no_auto_restore', 16:14:15 INFO - 'tabpaint']}, 16:14:15 INFO - 'other-e10s_l64': {'tests': ['a11yr', 16:14:15 INFO - 'ts_paint', 16:14:15 INFO - 'tpaint', 16:14:15 INFO - 'sessionrestore', 16:14:15 INFO - 'sessionrestore_no_auto_restore', 16:14:15 INFO - 'tabpaint']}, 16:14:15 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 16:14:15 INFO - 'ts_paint', 16:14:15 INFO - 'tpaint', 16:14:15 INFO - 'sessionrestore', 16:14:15 INFO - 'sessionrestore_no_auto_restore', 16:14:15 INFO - 'tabpaint']}, 16:14:15 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['a11yr', 16:14:15 INFO - 'ts_paint', 16:14:15 INFO - 'tpaint', 16:14:15 INFO - 'sessionrestore', 16:14:15 INFO - 'sessionrestore_no_auto_restore', 16:14:15 INFO - 'tabpaint']}, 16:14:15 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['a11yr', 16:14:15 INFO - 'ts_paint', 16:14:15 INFO - 'tpaint', 16:14:15 INFO - 'sessionrestore', 16:14:15 INFO - 'sessionrestore_no_auto_restore', 16:14:15 INFO - 'tabpaint']}, 16:14:15 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['tsvgx', 16:14:15 INFO - 'tsvgr_opacity', 16:14:15 INFO - 'tart', 16:14:15 INFO - 'tscrollx', 16:14:15 INFO - 'cart']}, 16:14:15 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:14:15 INFO - 'tsvgr_opacity', 16:14:15 INFO - 'tart', 16:14:15 INFO - 'tscrollx', 16:14:15 INFO - 'cart']}, 16:14:15 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:14:15 INFO - 'talos_options': ['--disable-e10s'], 16:14:15 INFO - 'tests': ['tp5o']}, 16:14:15 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:14:15 INFO - 'tests': ['tp5o']}, 16:14:15 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:14:15 INFO - 'talos_options': ['--disable-e10s', 16:14:15 INFO - '--xperf_path', 16:14:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:14:15 INFO - 'tests': ['tp5n']}, 16:14:15 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:14:15 INFO - 'talos_options': ['--xperf_path', 16:14:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:14:15 INFO - 'tests': ['tp5n']}}, 16:14:15 INFO - 'talos.zip': {'path': '', 16:14:15 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:14:15 INFO - Running post-action listener: _resource_record_post_action 16:14:15 INFO - [mozharness: 2016-08-12 23:14:15.167198Z] Finished populate-webroot step (success) 16:14:15 INFO - [mozharness: 2016-08-12 23:14:15.167327Z] Running create-virtualenv step. 16:14:15 INFO - Running pre-action listener: _resource_record_pre_action 16:14:15 INFO - Running main action method: create_virtualenv 16:14:15 INFO - Creating virtualenv /builds/slave/test/build/venv 16:14:15 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 16:14:15 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:14:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:14:15 INFO - Using real prefix '/tools/python27' 16:14:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:14:16 INFO - Installing distribute.............................................................................................................................................................................................done. 16:14:18 INFO - Installing pip.................done. 16:14:18 INFO - Return code: 0 16:14:18 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:14:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:14:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:14:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 16:14:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:14:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:18 INFO - 'HOME': '/Users/cltbld', 16:14:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:18 INFO - 'LOGNAME': 'cltbld', 16:14:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:18 INFO - 'MOZ_NO_REMOTE': '1', 16:14:18 INFO - 'NO_EM_RESTART': '1', 16:14:18 INFO - 'PAGER': '/bin/cat', 16:14:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:18 INFO - 'PWD': '/builds/slave/test', 16:14:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:18 INFO - 'SHELL': '/bin/bash', 16:14:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:18 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:18 INFO - 'USER': 'cltbld', 16:14:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:18 INFO - 'XPC_FLAGS': '0x0', 16:14:18 INFO - 'XPC_SERVICE_NAME': '0', 16:14:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:19 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 16:14:19 INFO - Cleaning up... 16:14:19 INFO - Return code: 0 16:14:19 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:14:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:14:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:14:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 16:14:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 16:14:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:19 INFO - 'HOME': '/Users/cltbld', 16:14:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:19 INFO - 'LOGNAME': 'cltbld', 16:14:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:19 INFO - 'MOZ_NO_REMOTE': '1', 16:14:19 INFO - 'NO_EM_RESTART': '1', 16:14:19 INFO - 'PAGER': '/bin/cat', 16:14:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:19 INFO - 'PWD': '/builds/slave/test', 16:14:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:19 INFO - 'SHELL': '/bin/bash', 16:14:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:19 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:19 INFO - 'USER': 'cltbld', 16:14:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:19 INFO - 'XPC_FLAGS': '0x0', 16:14:19 INFO - 'XPC_SERVICE_NAME': '0', 16:14:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:19 INFO - Downloading/unpacking psutil>=3.1.1 16:14:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:14:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:14:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:14:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:14:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:14:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:14:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:14:22 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:14:22 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:14:22 INFO - Installing collected packages: psutil 16:14:22 INFO - Running setup.py install for psutil 16:14:22 INFO - building 'psutil._psutil_osx' extension 16:14:22 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 16:14:23 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 16:14:23 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 16:14:23 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 16:14:23 INFO - building 'psutil._psutil_posix' extension 16:14:23 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 16:14:23 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 16:14:23 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 16:14:23 INFO - ^ 16:14:23 INFO - 1 warning generated. 16:14:23 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 16:14:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:14:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:14:23 INFO - Successfully installed psutil 16:14:23 INFO - Cleaning up... 16:14:23 INFO - Return code: 0 16:14:23 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:14:23 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')]} 16:14:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:23 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')]} 16:14:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:23 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 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:23 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 16:14:23 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 16:14:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:23 INFO - 'HOME': '/Users/cltbld', 16:14:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:23 INFO - 'LOGNAME': 'cltbld', 16:14:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:23 INFO - 'MOZ_NO_REMOTE': '1', 16:14:23 INFO - 'NO_EM_RESTART': '1', 16:14:23 INFO - 'PAGER': '/bin/cat', 16:14:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:23 INFO - 'PWD': '/builds/slave/test', 16:14:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:23 INFO - 'SHELL': '/bin/bash', 16:14:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:23 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:23 INFO - 'USER': 'cltbld', 16:14:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:23 INFO - 'XPC_FLAGS': '0x0', 16:14:23 INFO - 'XPC_SERVICE_NAME': '0', 16:14:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:23 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:14:23 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 16:14:23 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 16:14:23 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 16:14:23 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 16:14:23 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 16:14:23 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 16:14:26 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:14:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:14:26 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:14:26 INFO - Installing collected packages: mozsystemmonitor 16:14:26 INFO - Running setup.py install for mozsystemmonitor 16:14:26 INFO - Successfully installed mozsystemmonitor 16:14:26 INFO - Cleaning up... 16:14:26 INFO - Return code: 0 16:14:26 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:14:26 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')]} 16:14:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:26 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')]} 16:14:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:26 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 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:26 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 16:14:26 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 16:14:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:26 INFO - 'HOME': '/Users/cltbld', 16:14:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:26 INFO - 'LOGNAME': 'cltbld', 16:14:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:26 INFO - 'MOZ_NO_REMOTE': '1', 16:14:26 INFO - 'NO_EM_RESTART': '1', 16:14:26 INFO - 'PAGER': '/bin/cat', 16:14:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:26 INFO - 'PWD': '/builds/slave/test', 16:14:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:26 INFO - 'SHELL': '/bin/bash', 16:14:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:26 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:26 INFO - 'USER': 'cltbld', 16:14:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:26 INFO - 'XPC_FLAGS': '0x0', 16:14:26 INFO - 'XPC_SERVICE_NAME': '0', 16:14:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:26 INFO - Downloading/unpacking jsonschema==2.5.1 16:14:26 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 16:14:26 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 16:14:26 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 16:14:26 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 16:14:26 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 16:14:26 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 16:14:29 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:14:29 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:14:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:14:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:14:29 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:14:29 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:14:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:14:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:14:29 INFO - Downloading functools32-3.2.3-2.tar.gz 16:14:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:14:29 INFO - warning: no files found matching '*.txt' 16:14:29 INFO - no previously-included directories found matching 'build' 16:14:29 INFO - no previously-included directories found matching 'dist' 16:14:29 INFO - no previously-included directories found matching '.git*' 16:14:29 INFO - Installing collected packages: jsonschema, functools32 16:14:29 INFO - Running setup.py install for functools32 16:14:29 INFO - warning: no files found matching '*.txt' 16:14:29 INFO - no previously-included directories found matching 'build' 16:14:29 INFO - no previously-included directories found matching 'dist' 16:14:29 INFO - no previously-included directories found matching '.git*' 16:14:29 INFO - Successfully installed jsonschema functools32 16:14:29 INFO - Cleaning up... 16:14:29 INFO - Return code: 0 16:14:29 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:14:29 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')]} 16:14:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:29 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')]} 16:14:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:29 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 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:29 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 16:14:29 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 16:14:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:29 INFO - 'HOME': '/Users/cltbld', 16:14:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:29 INFO - 'LOGNAME': 'cltbld', 16:14:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:29 INFO - 'MOZ_NO_REMOTE': '1', 16:14:29 INFO - 'NO_EM_RESTART': '1', 16:14:29 INFO - 'PAGER': '/bin/cat', 16:14:29 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:29 INFO - 'PWD': '/builds/slave/test', 16:14:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:29 INFO - 'SHELL': '/bin/bash', 16:14:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:29 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:29 INFO - 'USER': 'cltbld', 16:14:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:29 INFO - 'XPC_FLAGS': '0x0', 16:14:29 INFO - 'XPC_SERVICE_NAME': '0', 16:14:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:30 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:14:30 INFO - Cleaning up... 16:14:30 INFO - Return code: 0 16:14:30 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:14:30 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')]} 16:14:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:30 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')]} 16:14:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:30 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 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:30 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 16:14:30 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 16:14:30 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:30 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:30 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:30 INFO - 'HOME': '/Users/cltbld', 16:14:30 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:30 INFO - 'LOGNAME': 'cltbld', 16:14:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:30 INFO - 'MOZ_NO_REMOTE': '1', 16:14:30 INFO - 'NO_EM_RESTART': '1', 16:14:30 INFO - 'PAGER': '/bin/cat', 16:14:30 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:30 INFO - 'PWD': '/builds/slave/test', 16:14:30 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:30 INFO - 'SHELL': '/bin/bash', 16:14:30 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:30 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:30 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:30 INFO - 'USER': 'cltbld', 16:14:30 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:30 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:30 INFO - 'XPC_FLAGS': '0x0', 16:14:30 INFO - 'XPC_SERVICE_NAME': '0', 16:14:30 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:30 INFO - Downloading/unpacking blobuploader==1.2.4 16:14:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:14:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:14:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:14:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:14:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:14:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:14:32 INFO - Downloading blobuploader-1.2.4.tar.gz 16:14:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:14:32 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:14:32 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 16:14:32 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 16:14:32 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 16:14:32 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 16:14:32 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 16:14:32 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 16:14:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:14:33 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:14:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:14:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:14:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:14:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:14:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:14:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:14:33 INFO - Downloading docopt-0.6.1.tar.gz 16:14:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:14:34 INFO - Installing collected packages: blobuploader, requests, docopt 16:14:34 INFO - Running setup.py install for blobuploader 16:14:34 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:14:34 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:14:34 INFO - Running setup.py install for requests 16:14:34 INFO - Running setup.py install for docopt 16:14:34 INFO - Successfully installed blobuploader requests docopt 16:14:34 INFO - Cleaning up... 16:14:35 INFO - Return code: 0 16:14:35 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:14:35 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')]} 16:14:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:35 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')]} 16:14:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:35 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 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:35 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 16:14:35 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 16:14:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:35 INFO - 'HOME': '/Users/cltbld', 16:14:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:35 INFO - 'LOGNAME': 'cltbld', 16:14:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:35 INFO - 'MOZ_NO_REMOTE': '1', 16:14:35 INFO - 'NO_EM_RESTART': '1', 16:14:35 INFO - 'PAGER': '/bin/cat', 16:14:35 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:35 INFO - 'PWD': '/builds/slave/test', 16:14:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:35 INFO - 'SHELL': '/bin/bash', 16:14:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:35 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:35 INFO - 'USER': 'cltbld', 16:14:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:35 INFO - 'XPC_FLAGS': '0x0', 16:14:35 INFO - 'XPC_SERVICE_NAME': '0', 16:14:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:14:35 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-y_hBr7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:14:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:14:35 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-9zBS3x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:14:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:14:35 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-ONwLen-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:14:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:14:35 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-okX_cZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:14:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:14:35 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-qT7cCz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:14:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:14:35 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-g5RFnQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:14:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:14:35 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-zcHCmR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:14:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:14:35 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-tp7CNV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-MkdNlh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-dKDQqX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-MGuGPo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-AemCPh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-wf6ise-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-0fASYf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-uO7hoj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-yRHBjm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:14:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:14:36 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-lRGjJv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:14:37 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:14:37 INFO - Running setup.py install for manifestparser 16:14:37 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:14:37 INFO - Running setup.py install for mozcrash 16:14:37 INFO - Running setup.py install for mozdebug 16:14:37 INFO - Running setup.py install for mozdevice 16:14:37 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:14:37 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:14:37 INFO - Running setup.py install for mozfile 16:14:37 INFO - Running setup.py install for mozhttpd 16:14:37 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:14:37 INFO - Running setup.py install for mozinfo 16:14:38 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Running setup.py install for mozInstall 16:14:38 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Running setup.py install for mozleak 16:14:38 INFO - Running setup.py install for mozlog 16:14:38 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Running setup.py install for moznetwork 16:14:38 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Running setup.py install for mozprocess 16:14:38 INFO - Running setup.py install for mozprofile 16:14:38 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:14:38 INFO - Running setup.py install for mozrunner 16:14:39 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:14:39 INFO - Running setup.py install for mozscreenshot 16:14:39 INFO - Running setup.py install for moztest 16:14:39 INFO - Running setup.py install for mozversion 16:14:39 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:14:39 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:14:39 INFO - Cleaning up... 16:14:39 INFO - Return code: 0 16:14:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:14: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')]} 16:14:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14: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')]} 16:14:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:39 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 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:39 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 16:14:39 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 16:14:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:39 INFO - 'HOME': '/Users/cltbld', 16:14:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:39 INFO - 'LOGNAME': 'cltbld', 16:14:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:39 INFO - 'MOZ_NO_REMOTE': '1', 16:14:39 INFO - 'NO_EM_RESTART': '1', 16:14:39 INFO - 'PAGER': '/bin/cat', 16:14:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:39 INFO - 'PWD': '/builds/slave/test', 16:14:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:39 INFO - 'SHELL': '/bin/bash', 16:14:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:39 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:39 INFO - 'USER': 'cltbld', 16:14:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:39 INFO - 'XPC_FLAGS': '0x0', 16:14:39 INFO - 'XPC_SERVICE_NAME': '0', 16:14:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:14:39 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-MJh8ww-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:14:39 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)) 16:14:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:14:39 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-dx4Alh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-URJX1T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-69sjT8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-6wyBTw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-vLM9Gh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-eg3LhP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-M4D3jy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-HI02ch-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-skkiUu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:14:40 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)) 16:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:14:40 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-xZKJzi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:14:41 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)) 16:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:14:41 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-3GxTLT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:14:41 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)) 16:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:14:41 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-gX6kRl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:14:41 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)) 16:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:14:41 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-7bJ2wo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:14:41 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)) 16:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:14:41 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-8ldOBR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:14:41 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)) 16:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:14:41 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-n4ZRRZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:14:41 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)) 16:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:14:41 INFO - Running setup.py (path:/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/pip-Lsn9fw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:14:41 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)) 16:14:41 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)) 16:14:41 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)) 16:14:41 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)) 16:14:41 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)) 16:14:41 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)) 16:14:41 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:14:41 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 16:14:41 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 16:14:41 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 16:14:41 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 16:14:41 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 16:14:41 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 16:14:44 INFO - Downloading blessings-1.6.tar.gz 16:14:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:14:44 INFO - Installing collected packages: blessings 16:14:44 INFO - Running setup.py install for blessings 16:14:44 INFO - Successfully installed blessings 16:14:44 INFO - Cleaning up... 16:14:44 INFO - Return code: 0 16:14:44 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:14:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:14:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:14:44 INFO - Reading from file tmpfile_stdout 16:14:44 INFO - Current package versions: 16:14:44 INFO - blessings == 1.6 16:14:44 INFO - blobuploader == 1.2.4 16:14:44 INFO - docopt == 0.6.1 16:14:44 INFO - functools32 == 3.2.3-2 16:14:44 INFO - jsonschema == 2.5.1 16:14:44 INFO - manifestparser == 1.1 16:14:44 INFO - mozInstall == 1.12 16:14:44 INFO - mozcrash == 0.17 16:14:44 INFO - mozdebug == 0.1 16:14:44 INFO - mozdevice == 0.48 16:14:44 INFO - mozfile == 1.2 16:14:44 INFO - mozhttpd == 0.7 16:14:44 INFO - mozinfo == 0.9 16:14:44 INFO - mozleak == 0.1 16:14:44 INFO - mozlog == 3.3 16:14:44 INFO - moznetwork == 0.27 16:14:44 INFO - mozprocess == 0.23 16:14:44 INFO - mozprofile == 0.28 16:14:44 INFO - mozrunner == 6.12 16:14:44 INFO - mozscreenshot == 0.1 16:14:44 INFO - mozsystemmonitor == 0.3 16:14:44 INFO - moztest == 0.7 16:14:44 INFO - mozversion == 1.4 16:14:44 INFO - psutil == 3.1.1 16:14:44 INFO - requests == 1.2.3 16:14:44 INFO - wsgiref == 0.1.2 16:14:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:14:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:14:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14: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')]} 16:14:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14:45 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 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14:45 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 16:14:45 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 16:14:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:45 INFO - 'HOME': '/Users/cltbld', 16:14:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:45 INFO - 'LOGNAME': 'cltbld', 16:14:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:45 INFO - 'MOZ_NO_REMOTE': '1', 16:14:45 INFO - 'NO_EM_RESTART': '1', 16:14:45 INFO - 'PAGER': '/bin/cat', 16:14:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:45 INFO - 'PWD': '/builds/slave/test', 16:14:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:45 INFO - 'SHELL': '/bin/bash', 16:14:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:45 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:45 INFO - 'USER': 'cltbld', 16:14:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:45 INFO - 'XPC_FLAGS': '0x0', 16:14:45 INFO - 'XPC_SERVICE_NAME': '0', 16:14:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 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)) 16:14:45 INFO - Cleaning up... 16:14:45 INFO - Return code: 0 16:14:45 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:14: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')]} 16:14:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:14:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14: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')]} 16:14:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:14:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:14: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c08da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c122618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff729c5faf0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, '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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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 16:14: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', 'jsonschema'] in /builds/slave/test/build 16:14: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 jsonschema 16:14:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:14:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:14:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:14:45 INFO - 'HOME': '/Users/cltbld', 16:14:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:14:45 INFO - 'LOGNAME': 'cltbld', 16:14:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:45 INFO - 'MOZ_NO_REMOTE': '1', 16:14:45 INFO - 'NO_EM_RESTART': '1', 16:14:45 INFO - 'PAGER': '/bin/cat', 16:14:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:14:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:45 INFO - 'PWD': '/builds/slave/test', 16:14:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:14:45 INFO - 'SHELL': '/bin/bash', 16:14:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:14:45 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:14:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:14:45 INFO - 'USER': 'cltbld', 16:14:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:14:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:14:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:45 INFO - 'XPC_FLAGS': '0x0', 16:14:45 INFO - 'XPC_SERVICE_NAME': '0', 16:14:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:14:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:14:45 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:14:45 INFO - Cleaning up... 16:14:45 INFO - Return code: 0 16:14:45 INFO - Running post-action listener: _resource_record_post_action 16:14:45 INFO - Running post-action listener: _start_resource_monitoring 16:14:45 INFO - Starting resource monitoring. 16:14:45 INFO - [mozharness: 2016-08-12 23:14:45.736317Z] Finished create-virtualenv step (success) 16:14:45 INFO - [mozharness: 2016-08-12 23:14:45.737273Z] Running install step. 16:14:45 INFO - Running pre-action listener: _resource_record_pre_action 16:14:45 INFO - Running main action method: install 16:14:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:14:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:14:45 INFO - Reading from file tmpfile_stdout 16:14:45 INFO - Detecting whether we're running mozinstall >=1.0... 16:14:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:14:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:14:46 INFO - Reading from file tmpfile_stdout 16:14:46 INFO - Output received: 16:14:46 INFO - Usage: mozinstall [options] installer 16:14:46 INFO - Options: 16:14:46 INFO - -h, --help show this help message and exit 16:14:46 INFO - -d DEST, --destination=DEST 16:14:46 INFO - Directory to install application into. [default: 16:14:46 INFO - "/builds/slave/test"] 16:14:46 INFO - --app=APP Application being installed. [default: firefox] 16:14:46 INFO - mkdir: /builds/slave/test/build/application 16:14:46 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'] 16:14:46 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 16:15:20 INFO - Reading from file tmpfile_stdout 16:15:20 INFO - Output received: 16:15:20 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 16:15:20 INFO - Running post-action listener: _resource_record_post_action 16:15:20 INFO - [mozharness: 2016-08-12 23:15:20.405496Z] Finished install step (success) 16:15:20 INFO - [mozharness: 2016-08-12 23:15:20.405627Z] Running run-tests step. 16:15:20 INFO - Running pre-action listener: _resource_record_pre_action 16:15:20 INFO - Running main action method: run_tests 16:15:20 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:15:20 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:15:20 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:15:20 INFO - 2016-08-12 16:15:20.420 screenresolution[1992:11524] starting screenresolution argv=screenresolution get 16:15:20 INFO - 2016-08-12 16:15:20.422 screenresolution[1992:11524] Display 0: 1600x1200x32@60 16:15:20 INFO - 2016-08-12 16:15:20.428 screenresolution[1993:11526] starting screenresolution argv=screenresolution list 16:15:20 INFO - Available Modes on Display 0 16:15:20 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:15:20 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:15:20 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:15:20 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:15:20 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:15:20 INFO - Intel Iris: 16:15:20 INFO - Chipset Model: Intel Iris 16:15:20 INFO - Type: GPU 16:15:20 INFO - Bus: Built-In 16:15:20 INFO - VRAM (Dynamic, Max): 1536 MB 16:15:20 INFO - Vendor: Intel (0x8086) 16:15:20 INFO - Device ID: 0x0a2e 16:15:20 INFO - Revision ID: 0x0009 16:15:20 INFO - Displays: 16:15:20 INFO - Display: 16:15:20 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:15:20 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:15:20 INFO - Display Serial Number: 1600x1200 60 16:15:20 INFO - Main Display: Yes 16:15:20 INFO - Mirror: Off 16:15:20 INFO - Online: Yes 16:15:20 INFO - Rotation: Supported 16:15:20 INFO - Return code: 0 16:15:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:15:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:15:20 INFO - Python 2.7.3 16:15:20 INFO - Return code: 0 16:15:20 INFO - grabbing minidump binary from tooltool 16:15:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:15:20 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 0x10bff1d30>, '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 0x10bd56db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10bfe9b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:15:20 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 16:15:20 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 16:15:20 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 16:15:20 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:15:20 INFO - Return code: 0 16:15:20 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 16:15:20 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:15:20 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:15:20 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 16:15:20 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:15:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0029', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 16:15:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0029 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 16:15:20 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8LPugtOCSQ/Render', 16:15:20 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:15:20 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:15:20 INFO - 'HOME': '/Users/cltbld', 16:15:20 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:15:20 INFO - 'LOGNAME': 'cltbld', 16:15:20 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:15:20 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 16:15:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:15:20 INFO - 'MOZ_NO_REMOTE': '1', 16:15:20 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:15:20 INFO - 'NO_EM_RESTART': '1', 16:15:20 INFO - 'PAGER': '/bin/cat', 16:15:20 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:15:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:15:20 INFO - 'PWD': '/builds/slave/test', 16:15:20 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:15:20 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:15:20 INFO - 'SHELL': '/bin/bash', 16:15:20 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.AgBOqxm2Zq/Listeners', 16:15:20 INFO - 'TMPDIR': '/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/', 16:15:20 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:15:20 INFO - 'USER': 'cltbld', 16:15:20 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:15:20 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:15:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:15:20 INFO - 'XPC_FLAGS': '0x0', 16:15:20 INFO - 'XPC_SERVICE_NAME': '0', 16:15:20 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 16:15:20 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0029', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 16:15:20 INFO - mozversion application_buildid: 20160812134617 16:15:20 INFO - mozversion application_changeset: ef3a50774180e1ccc1b6d210295db8275739b92e 16:15:20 INFO - mozversion application_display_name: Nightly 16:15:20 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:15:20 INFO - mozversion application_name: Firefox 16:15:20 INFO - mozversion application_remotingname: firefox 16:15:20 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 16:15:20 INFO - mozversion application_vendor: Mozilla 16:15:20 INFO - mozversion application_version: 51.0a1 16:15:20 INFO - mozversion platform_buildid: 20160812134617 16:15:20 INFO - mozversion platform_changeset: ef3a50774180e1ccc1b6d210295db8275739b92e 16:15:20 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 16:15:20 INFO - mozversion platform_version: 51.0a1 16:15:20 INFO - using testdate: 1471043720 16:15:20 INFO - actual date: 1471043720 16:15:20 INFO - starting webserver on 'localhost:49415' 16:15:20 INFO - SUITE-START | Running 2 tests 16:15:20 INFO - TEST-START | dromaeo_css 16:15:20 INFO - operating with platform_type : mac_ 16:15:20 INFO - Initialising browser for dromaeo_css test... 16:15:20 INFO - TEST-INFO | started process 2003 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/tmpZo2tPf/profile http://localhost:49415/getInfo.html) 16:15:23 INFO - PROCESS | 2003 | __metrics Screen width/height:1600/1200 16:15:23 INFO - PROCESS | 2003 | colorDepth:24 16:15:23 INFO - PROCESS | 2003 | Browser inner width/height: 1024/689 16:15:23 INFO - PROCESS | 2003 | __metrics 16:15:23 ERROR - PROCESS | 2003 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 16:15:24 INFO - TEST-INFO | 2003: exit 0 16:15:24 INFO - Browser initialized. 16:15:24 INFO - Running cycle 1/1 for dromaeo_css test... 16:15:24 INFO - TEST-INFO | started process 2006 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/tmpZo2tPf/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:15:36 INFO - PROCESS | 2006 | RSS: Main: 239665152 16:15:36 INFO - PROCESS | 2006 | 16:16:26 INFO - PROCESS | 2006 | 1471043786036 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] 16:18:37 INFO - PROCESS | 2006 | Cycle 1(1): loaded http://localhost:49415/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49415/tests/dromaeo/cssquery-ext.html) 16:18:39 INFO - PROCESS | 2006 | RSS: Main: 254431232 16:18:39 INFO - PROCESS | 2006 | 16:21:41 INFO - PROCESS | 2006 | Cycle 1(1): loaded http://localhost:49415/tests/dromaeo/cssquery-ext.html (next: http://localhost:49415/tests/dromaeo/cssquery-jquery.html) 16:21:42 INFO - PROCESS | 2006 | RSS: Main: 264499200 16:21:42 INFO - PROCESS | 2006 | 16:24:44 INFO - PROCESS | 2006 | Cycle 1(1): loaded http://localhost:49415/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49415/tests/dromaeo/cssquery-mootools.html) 16:24:44 INFO - PROCESS | 2006 | RSS: Main: 269348864 16:24:44 INFO - PROCESS | 2006 | 16:27:46 INFO - PROCESS | 2006 | Cycle 1(1): loaded http://localhost:49415/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49415/tests/dromaeo/cssquery-prototype.html) 16:27:47 INFO - PROCESS | 2006 | RSS: Main: 270721024 16:27:47 INFO - PROCESS | 2006 | 16:30:49 INFO - PROCESS | 2006 | Cycle 1(1): loaded http://localhost:49415/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49415/tests/dromaeo/cssquery-yui.html) 16:30:50 INFO - PROCESS | 2006 | RSS: Main: 276283392 16:30:50 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | Cycle 1(1): loaded http://localhost:49415/tests/dromaeo/cssquery-yui.html (next: http://localhost:49415/tests/dromaeo/cssquery-dojo.html) 16:33:53 INFO - PROCESS | 2006 | RSS: Main: 278851584 16:33:53 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | __start_tp_report 16:33:53 INFO - PROCESS | 2006 | _x_x_mozilla_page_load 16:33:53 INFO - PROCESS | 2006 | _x_x_mozilla_page_load_details 16:33:53 INFO - PROCESS | 2006 | |i|pagename|runs| 16:33:53 INFO - PROCESS | 2006 | |0;dojo.html;3404.2170300830808;3422.777519461235;3424.657534246576;3435.4846772984033;3473.5484387029683;5802.419758024206;5912.645241285521;5946.167536544887;5969.910451343228;5999.580029397944;5896.616719913213;5907.438793314628;5942.168096466498;5948.672822994745;6018.307894592123;5217.243499692542;5358.410574836765;5401.4868587484125;5406.83779486616;5422.240886275925;5217.608679349064;5246.895062098756;5367.06076436624;5422.728863556826;5439.184122381655;5301.5228629423345;5320.388155362144;5344.385395679507;5344.759485823109;5382.596305277119;5295.549878260353;5322.733863306819;5326.786928522854;5354.785808567692;5377.542908852753;4695.765211739434;5214.478552144793;5270.6047046471285;5274.55166310864;5297.735113244323;4921.532454416824;5794.942050579524;5896.764129434818;5926.970365148147;5994.55040871932;6231.252249730016;6290.283306250039;6293.244810622755;6323.588966717149;6326.177596912418;6147.801178770142;6236.594621349598;6327.620342779448;6351.587146835441;6365.140706004677;5853.32686741026;5954.136650185699;5955.196048533479;6027.608205466675;6029.366916473795;6348.555601107971;6360.268569114611;6407.13503677007;6407.839804004937;6428.903566446507;6137.683438940261;6202.131701561785;6280.905786413207;6304.991201407753;6333;6243.656598887105;6298.968505157445;6313.621182729051;6322.968385158137;6345.17512723343;6234.189555357865;6257.092721555349;6269.811905642838;6296.401841825019;6364.459020983269;6130.153553065287;6208.255009398901;6297.055441683784;6306.463950564162;6332.968335158294;5001.64988450805;5035;5041.470645582234;5045.445001049881;5080.618953578496;4488.865334039919;4525.411696479437;4526.569975852289;4551.544845515488;4559.498455169929;5866.149408335853;5996.940030599725;6009.729562169713;6070.696465176724;6109;6312.652804095727;6314.0528920661345;6333.746650133943;6349.365063493706;6353.5870168438905;6067.544934129958;6073.6659483727935;6073.939260607426;6082.239720034996;6092.543059270483;5438.8912221755345;5495.670259784426;5518.806841760519;5584.832455026356;5602.075657516546;6379.776707815297;6474.99637556189;6487.643179625166;6498.122753428322;6504.447121994494;6260.499160067093;6273.309935906956;6301.905471417841;6322.083297921868;6330.556861019684;6285.340039295808;6329.145565348803;6386.712597933011;6471.2234531856475;6480.805575832733;6218.315985241529;6304.211973503312;6305.90541141874;6316.873662526816;6317.30509643948;6115.174451448997;6288.151099601495;6288.339724328879;6292.905606415816;6303.747850085945;6126.27339965311;6192.628442293477;6217.067439884054;6264.436200741955;6283.8114856554375;6210.472109870531;6261.530385221035;6273.905891411724;6273.96863015682;6288.905666414916;5895.793647222326;6084.39156084388;6168.136460895568;6177.351378105234;6177.413145751147;6064.727087281171;6153.630782153085;6234.844128896814;6268.153799237227;6269.373062693694;6083;6152.538559607958;6180.443760061616;6186.597871138361;6193.977993631001 16:33:53 INFO - PROCESS | 2006 | |1;ext.html;503.3808415648753;529.8940211957608;539.5818240863327;543.3099963046931;564.5257983294032;26460.470790584175;33723.15692107699;41241;41382.793086034566;41439.37840932381;35430.468542971874;42659.3601095983;42811.57188428115;42893.142137157316;43671.689849304494;8359.665613375457;9645.373050751696;9830.459324737136;9841.26190535709;9874.40753554789;8370.414071015031;8874.467531948072;9704.757381065494;9836.163926066292;9846.60613575456;7847.843043139133;9791.853122203172;9829.311948163631;9841.065098815638;9854.458004809732;9806.215502759798;9817.50912454378;9831.852522212173;9832.606695732162;9840.606375744961;9594.856077158849;9608.991055939096;9649.083337082966;9656.179224765903;9685.467299298536;40411.595884041075;40566.18867622661;40670.186596268206;40702.185956281006;40720.79639601813;3049.3407166447273;3422.640622734602;3456.844442000091;3560.893173204808;3653.2876089162623;30444.84777576098;31964.04107876744;32477.350452991042;32704.6729532704;32793.50809737856;3274.918127046819;3376.459766437358;3416.419208734521;3445.3453843769603;3460.653934606519;516492;520388;525387;526614;528694.3565282149;54008.45991540113;62009.68995154995;62699;63486.682566586875;63718;65405;65493.67253163799;65520;66136.66931665406;66184.33815661877;16185.59536011609;16201.189940502927;16282.83717162837;16354;16375.59061023484;12380.257184568954;12432.502699891904;12537.059720520998;12590.622281331574;12709.428075736614;18833.81166188348;18954.431367058736;18961.620767584845;18978.52553686169;18995.81004189968;7838.764837054898;7961.601919903982;7961.960190199012;8009.879851802228;8022.919770802334;862.7066797288952;904.2720609908955;987.5950860147449;1008.5965613754557;1145.959891403797;25240.368990775376;30417.327047012182;30822.845885770876;31094.378112438077;31434.528482072787;1119.960801371948;1137.419915842926;1142.5886680794906;1154.6420609611048;1199.7000749812546;15599.06405615644;15831.366745330059;15980.360785568679;16116.677666446605;16251.431199907947;657675;727339;728223;728224;729878;59928.40071599316;60601.78796424135;60609;60610;60677;1333.6399172223446;1359.4018631801976;1398;1398.8181536400202;1400.7828786538103;29609.703902960693;30714.232144196572;30718.84640576783;30996.845015774776;31264;50717.746411267704;51084.744576276884;51252;51323;51407.71480712863;602337;603871;604077;605782.9132563103;606329;26734.06430774991;26961;26986.1904142876;27138.778754955678;27321.45357092887;38316.61683383131;48301.75849120732;48886.5111348882;49010.50989490202;49376.25935610897;30740.846295768377;39773;39910;39956.600433995285;41337;36281.45577816388;38396.23207535778;39403.80298098491;40142.598574013886;41242.58757412388;37933;38400.615993840824;38431;39282;39380.606193937696;33482.83258583691;34935.9519214424;35337.11657208487;35569.82215088908;36368.63631363758;25137.49725005526;25359.87320063388;25868.35329116787;26091.60862587025;26168.21495355066 16:33:53 INFO - PROCESS | 2006 | |2;jquery.html;330.7321069933353;363.64907863911304;370.49982523593155;376.2324857291123;395.8934777297453;17548.298068077278;17622.82377176228;21002.684959725597;21095.47261318464;21480;20585.794142058574;20811.583768324625;21227.787722122775;21281.787182128173;21580.352589422302;5955.612885162462;6016.789412370568;6023.30731965823;6135.6625385603775;6205.22434695663;4241.448611680477;6013.939860601404;6139.815805525842;6153.876922461548;6564.277929427759;5410.972945135269;6784.898226526606;6801.693923773442;6901.137357830271;6907.861842763142;6069.514438844926;6623.635700036496;6675.232348279961;6817.0796942412635;6864.039034535169;5074.619403544749;5880.529557635422;5914.2015827863115;5927.703614819285;5937.198478205473;13182.86817131826;13660.65848353789;13753.449862005507;13771.793423098661;17627;2141.4325203821;2332.591796435617;2352.364861487406;2601.4016776141593;2633.2231991562535;10229.64196253135;10570.841437378445;10590.517327574145;10933.945330273376;15743.606409839846;1793.6054068104995;1811.2754898040757;1848.9907550462162;1879.9718004229946;1903.3528600275972;122928;124944;126312;129118;129364.3531782335;9568.282378821616;10999.505022274017;11483.420942178122;11661.24201926872;11959.162858599988;14481.203533805741;14576.927115364355;14705.852941470663;14706.558803235706;14736.042157259744;8301.709440169565;8524.70163544273;8554.05905350411;8643.956780216058;8671.609777560025;7803.453758236869;7899.368050555941;7992.68029278834;8521.446106003214;8699.086595907465;4497;4565.474970378449;4609.285560738091;4666.533346665306;4674.883127921829;1882.162437715231;1926.6724656808376;1930.2182616040527;3718.6839118674675;3918.647321741057;840.8774286327699;905.4150400606175;930.930180236485;973.1582181413169;999.2855108597388;20833.479163021046;21338.78661213399;21742.565148697253;22427.663585046237;22572.88713556422;781.819452626538;802.955837428947;851.212628318815;1001.4477559782308;1054.97667262755;11220.887791122148;11544.538218471334;11545.826812597817;11650.766984660258;11650.88349116515;616887;617595;626086;645392;653940;71852;116700;124359;140990.2950485241;141087;978.9363691360039;994.3487016004528;1024.5594394410475;1044.8380501022202;1046.3303485769113;15136;18832.62334753325;19538.90230548838;19562.804371956667;19590.11844467031;47862.52137478581;53238.40284791462;59041.704791475764;59277.11084333652;59588.106178406495;81743;82077.58961205155;82495.58752206201;83652;85474;7948.3641308694005;7964.283214510722;8116.513009219466;8158.224968627971;8269.62786674589;9677.9032209677;12123.636290911287;12443;12593;12740.917022053229;9679.032096790264;9690.56392462355;10021.298509104292;10115.241356898408;11223.270487418291;9843.523471479335;9873.654422095193;10682.412467314372;10867.945660271647;10890.61882834097;11314;11613.187076904536;11636.476358563716;11645.59240426581;11795;7173.7489187880265;7201.279872012757;7345.595992220479;7432.591207483641;8316.501009939422;9389.43663380172;10397.480125993821;10778.73053173677;11247.775044499227;11492.655220343404 16:33:53 INFO - PROCESS | 2006 | |3;mootools.html;1508.939642414303;1543.174401695093;1687.7805885234918;1706.7269236922086;1714.7256438969766;7540.245975402457;8514.191151840572;8664.220220180197;9015.45907245565;9034.68378606748;8645.913540864589;8848.557572121385;8860.601272942717;8868.201861832435;8913.548774087129;2095.19335056003;2256.909723611054;2366.148186652804;2370.8933098010543;2384.582698027847;2335.7313908900437;2374.560706269337;2385.5705972924866;2390.4740956989435;2396.8442051266697;2369.490559529701;2375.192434572245;2380.880955952204;2387.140629373424;2388.677528533643;2336.5210131923086;2357.422431504284;2361.1499860050367;2366.2428023032635;2376.3583832365252;2244.5847518209184;2345.5074434368803;2347.953040939172;2351.106579499796;2354.8704821234996;8936;8969.968453627785;8984.46093234408;8986.505742184178;9007.549622518847;5145.202493613496;5279.656822306538;5376.569874410077;5398.568114550826;5413.26920865682;2944.6613639431525;3205.7114859662743;3252.10567094051;3608.5308909841815;3686.7234957378037;934.4953724988566;986.8174387738292;991.6330957545682;1020.1583693452857;1050.5482642463737;11553.844615538463;11639.6508104757;11738.002269807077;11744.647660570197;11783.7054073648;4153.979230103831;4623.190941585276;4654.697444666086;4860.343853579792;4866.124097662384;9851.753706157404;9924.80150396988;9929.404235745878;9946.452945087945;9952.552135153936;5304.92042619361;5341.465853414627;5371.865703357369;5372;5372.462753724674;4447.466304043535;4791.736454494967;4892.19278818998;4931.211006239057;4949.975250123726;3664.212194378168;3879.321118804198;3949.822257998397;4018.517777866675;4058.3100872851687;1199.6640940536663;1298.318382848993;1303.2115570080155;1306.3468265867066;1315.8026296055477;918.6233644205977;935.6397786852111;938.0853667673963;941.7692665297046;978.3102912446708;5837.241158649348;5930.695247045643;6065.363136870653;6165.260168779775;6180.752769889244;433.1186036415941;439.7185801087307;451.22839943695993;458.9013362127159;459.3110334498253;3994.9201015979515;3999.560048394674;4056.6146216109423;4062.7156099073372;4133.91732165355;10653.414062226651;10965.793762686098;11011.339319640847;11064.004239618473;11085.390303533222;8748.212660860552;11026.834597481044;11056.502457389437;11111.888881111085;11165.274257173258;8331.250187483156;8403.789905252417;8422.326213902874;8439.987201535732;8487.533185674847;5750.309962804323;5853.2390789198835;5973.940260597338;5983.491403230774;6025.18659980897;9872.950635246778;10225.386476811414;10228.53971571296;10262.127719143957;10277.229207809294;10437.165026797686;10443.321184123008;10446.42544660051;10447.94776026115;10490;6908.447324214151;6912.4815638828295;7582.924170758221;7639.236076392316;7952.483088599222;6511.479081673549;8601.010883748198;8601.612927418406;8619.051904290398;8632.266257367943;7496.700131994878;7501.437392195717;7571.810704732426;7606.20134885829;7618.923810761821;7362.852742945004;7395.334419902235;7406.777796666109;7416.66625001887;7516.699332026657;5968.671723055274;7012.859742805013;7070;7082.752103676346;7163.498555101093;4071.89820254496;4218.620324170839;4668.323093151406;4994.675346102492;5384.865378365572;5034.144195486703;5174.197999310113;5210.426853046238;5237.528622424;5262.89474210506 16:33:53 INFO - PROCESS | 2006 | |4;prototype.html;306.2619087997925;307.2503092454411;312.2116655445002;316.6595909397398;317.8013741411618;5581.6371935824145;5587.357453892803;5592.217089607448;5614.971925140374;5651.265335506384;4745.857624271269;5472.589555783312;5499.085484693109;5571.944280557193;5589.664620122796;3698.7595806272507;4008.2785098682225;4148.875533733993;4186.1418409226035;4255.276602977486;3476.9826150869335;4182.372644103379;4188.937165942513;4201.995573165186;4223.936640950388;3731.6641502264793;4029.2948733971584;4196.181744559812;4216.915661686764;4236.555161708023;3281.967180328214;4055.675545956331;4198.202341555095;4205;4234.195502854448;2948.778841586868;3506.73699472538;3586.7668601540818;3602.837872295753;3603.1712706077487;4433.357163211349;4957.355543779322;5402.9729851350885;5412.83761487156;5421.864453388657;4255.765827909902;4644.674872758908;4823.252395878644;4826.927596086061;4848.127337079324;4635.8377456789185;4797.337477699875;5479.972600137014;5652.925944070614;5880.353840771627;3977.4630424892557;3999.42008408782;4002.2595819773437;4005.7782376375194;4019.77891215983;5737.254156959569;6081.300650425169;6101.359357267467;6143.907841382383;6181.845453863644;3255.544223808669;3416.79499230047;4036.59634036594;4079.6129316032693;4086.4891888513935;4108.50697916246;4151.6886233532605;4159.251334759711;4163.042500224965;4177.720489415794;4261.637760790306;4374.606285434326;4833.709977401297;4843.948312563063;4862.586680132157;5398.595105367113;5858.882822343615;5898.616589921641;5919.852003699942;5925.200097986803;1139.9145064120223;1162.9709257268466;1182.8225766134976;1399.5591388712523;1400.2298735695326;789.7995047527726;790.8932294140333;833.3791325462569;849.7068511363569;864.4856310495245;4833.9033219335415;4883.511648835088;5006.598152517301;5221.530062294336;5485.232067510552;5093.516115968977;5141.71720555373;5204.713740744295;6122.234720659918;6134.171886795315;4620.491745908014;5196.778756992104;5465.535429488458;5482.259894914136;5491.478309560585;2532.683414573178;2640.683118025849;3184.7292980096486;3231.3052693670975;3232.5453545903965;5474.698891560923;6215.9378406216265;6273.560850740404;6322.841928951813;6354.269259035178;5390.787072908564;6016.819495415145;6173.931732869449;6207.5654704171175;6246.906296405557;6030.758769649165;6097.481714054266;6225.875482490415;6346.809595712136;6356.078368636522;5630.465105814941;6000.969995149996;6079.787207447718;6107.786227482017;6116.785912493041;5946.097248880316;5995.250593675791;6005.87988240224;6030.638161710312;6054.182685337423;5309.513336265852;5856.472917437451;6306.9684651576445;6311.463525600192;6315.252865003555;3826.8710730335174;3939.2515422069714;3940.665043471337;3953.2093581284435;3989.4414781929972;6045.818625441244;6053.878922421615;6094.451499365078;6097.908531371944;6112.847178820387;5149.742512874416;5258.448757616588;5874.853128671817;5894.646321220741;5904.852378690567;5610.811783404557;5817.883642327214;5829.09649004405;5832.212651292191;5900.026495628345;5718.570357410647;5791.623544469596;5795.76816927335;5821.27234095738;5840.591158619026;4947.925781113214;5554;5558.166275058612;5558.861028474321;5566.888662226814;4975.512243878061;5667.3765885753355;5751.252337196138;5804.751978324681;5808.419158084158 16:33:53 INFO - PROCESS | 2006 | |5;yui.html;726.0960104669687;761.9047619047619;805.53681633061;807.5195258821001;832.421467080379;16181.676366472679;16192.271347789349;16206.35174593015;16406.015639061665;16434.835651643494;14643.633909152277;14704.852951470482;14732.116073035599;14751.26243687814;14763.409463621443;665.9001149827516;676.8510927595945;846.1834329871673;866.2377108144824;870.8258348330328;851.9957400212991;868.3096937934325;870.9564521773917;873.3188113271658;873.8995015573195;908.3959167153835;917.8393781088316;921.299812142773;921.6267411698273;921.6451666108529;881.7487016200353;910.7586489580233;913.712180663089;914.1818072824784;914.9359544831865;668.6055227415848;678.3352314731542;679.5854528737516;681.2131987554333;682.0962225051777;15103.924480377638;15133.54599362021;15173.24133793317;15179.772303415457;15192.544223673307;12107.818382724266;15024.549263522113;15109.697806043927;15166.848331516765;15166.924165379212;11997.46011429479;12228.144029917908;12300;12494.187877788005;12660.050496212822;3902.3951287550476;3926.823292951824;4067.7966101694797;4097.733647312945;4098.631123198897;105410.94589054164;122361.38819305935;122766;123513;123617;11540.884591154148;11565.884341156649;11580.247283926517;11605.361705106132;12066.698332541757;19744;21739.67390489144;22300.661960282436;24065.51868962611;24111.879440602686;8294.543800091053;8381.622826972802;8444.704435344733;8617.741467755977;8722.86915696265;3826.693864490834;4445.3998710174355;4537.682362234612;4629.722216667011;4802.991371811959;3601.5318008659233;3703.5555733312176;3723.0134014486184;3723.553173619183;3727.2731817295366;608.5861614102364;639.7888696730068;648.7826578096297;650.3204151661525;662.2351184382046;625.1435533319382;650.3236633900785;667.5727534378002;688.8358673841192;696.6969368324795;7851.646675899598;9351.766205844908;9483.762905927408;9689.25593393182;9780.510974451392;542.6066102076043;685.1127789512593;697.1625484278936;699.5662689132669;701.4248316380621;4304.83769382265;4546.795394207269;4816.109019831272;4852.80588776445;4873.366462359942;73785;127352.36323818506;163334;168067;174687;144432;148580;149693;150405.49594504133;151852;118571;120293;120951;122649.34831191023;123265.30204093891;9213.86179207299;9275.840519935007;9282.396644218104;9340.392874463138;9451.091624552975;65784;66903.66548167422;66959.66520167563;69458.65270673615;71197;94768;103069.96930030604;106188;106676;110361.79276414587;12052.397380131133;12367.9381603095;12825.358732063172;12853.228806271654;13202.537911173447;13245.933770331087;13458.798118028433;13549.458021679417;13721.779301095536;13982.650433739238;12379.616364215275;12552.372381381078;12584.370781460708;12777.93611031939;13051.673708157372;12447;12504.624861254177;12585;12665;12673.17624354414;12313.538908089917;12351.25892446456;12359.134860559674;12421.068419868365;12461.314627695563;8750.912490875264;10673.46632668348;10763;10768.838467422838;11023.669289921316;10772.730681733019;10781.19141064439;10933.125349972142;10999.285046471954;11020.228583999044 16:33:53 INFO - PROCESS | 2006 | __end_tp_report 16:33:53 INFO - PROCESS | 2006 | __start_cc_report 16:33:53 INFO - PROCESS | 2006 | _x_x_mozilla_cycle_collect,416 16:33:53 INFO - PROCESS | 2006 | __end_cc_report 16:33:53 INFO - PROCESS | 2006 | __startTimestamp1471044833571__endTimestamp 16:33:53 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | ------- Summary: start ------- 16:33:53 INFO - PROCESS | 2006 | Number of tests: 6 16:33:53 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | [#0] dojo.html Cycles:165 Average:5870.50 Median:6137.68 stddev:647.18 (10.5%) stddev-sans-first:619.57 16:33:53 INFO - PROCESS | 2006 | Values: 3404.2 3422.8 3424.7 3435.5 3473.5 5802.4 5912.6 5946.2 5969.9 5999.6 5896.6 5907.4 5942.2 5948.7 6018.3 5217.2 5358.4 5401.5 5406.8 5422.2 5217.6 5246.9 5367.1 5422.7 5439.2 5301.5 5320.4 5344.4 5344.8 5382.6 5295.5 5322.7 5326.8 5354.8 5377.5 4695.8 5214.5 5270.6 5274.6 5297.7 4921.5 5794.9 5896.8 5927.0 5994.6 6231.3 6290.3 6293.2 6323.6 6326.2 6147.8 6236.6 6327.6 6351.6 6365.1 5853.3 5954.1 5955.2 6027.6 6029.4 6348.6 6360.3 6407.1 6407.8 6428.9 6137.7 6202.1 6280.9 6305.0 6333.0 6243.7 6299.0 6313.6 6323.0 6345.2 6234.2 6257.1 6269.8 6296.4 6364.5 6130.2 6208.3 6297.1 6306.5 6333.0 5001.6 5035.0 5041.5 5045.4 5080.6 4488.9 4525.4 4526.6 4551.5 4559.5 5866.1 5996.9 6009.7 6070.7 6109.0 6312.7 6314.1 6333.7 6349.4 6353.6 6067.5 6073.7 6073.9 6082.2 6092.5 5438.9 5495.7 5518.8 5584.8 5602.1 6379.8 6475.0 6487.6 6498.1 6504.4 6260.5 6273.3 6301.9 6322.1 6330.6 6285.3 6329.1 6386.7 6471.2 6480.8 6218.3 6304.2 6305.9 6316.9 6317.3 6115.2 6288.2 6288.3 6292.9 6303.7 6126.3 6192.6 6217.1 6264.4 6283.8 6210.5 6261.5 6273.9 6274.0 6288.9 5895.8 6084.4 6168.1 6177.4 6177.4 6064.7 6153.6 6234.8 6268.2 6269.4 6083.0 6152.5 6180.4 6186.6 6194.0 16:33:53 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | [#1] ext.html Cycles:180 Average:74261.11 Median:40618.19 stddev:165861.53 (408.3%) stddev-sans-first:166234.37 16:33:53 INFO - PROCESS | 2006 | Values: 503.4 529.9 539.6 543.3 564.5 26460.5 33723.2 41241.0 41382.8 41439.4 35430.5 42659.4 42811.6 42893.1 43671.7 8359.7 9645.4 9830.5 9841.3 9874.4 8370.4 8874.5 9704.8 9836.2 9846.6 7847.8 9791.9 9829.3 9841.1 9854.5 9806.2 9817.5 9831.9 9832.6 9840.6 9594.9 9609.0 9649.1 9656.2 9685.5 40411.6 40566.2 40670.2 40702.2 40720.8 3049.3 3422.6 3456.8 3560.9 3653.3 30444.8 31964.0 32477.4 32704.7 32793.5 3274.9 3376.5 3416.4 3445.3 3460.7 516492.0 520388.0 525387.0 526614.0 528694.4 54008.5 62009.7 62699.0 63486.7 63718.0 65405.0 65493.7 65520.0 66136.7 66184.3 16185.6 16201.2 16282.8 16354.0 16375.6 12380.3 12432.5 12537.1 12590.6 12709.4 18833.8 18954.4 18961.6 18978.5 18995.8 7838.8 7961.6 7962.0 8009.9 8022.9 862.7 904.3 987.6 1008.6 1146.0 25240.4 30417.3 30822.8 31094.4 31434.5 1120.0 1137.4 1142.6 1154.6 1199.7 15599.1 15831.4 15980.4 16116.7 16251.4 657675.0 727339.0 728223.0 728224.0 729878.0 59928.4 60601.8 60609.0 60610.0 60677.0 1333.6 1359.4 1398.0 1398.8 1400.8 29609.7 30714.2 30718.8 30996.8 31264.0 50717.7 51084.7 51252.0 51323.0 51407.7 602337.0 603871.0 604077.0 605782.9 606329.0 26734.1 26961.0 26986.2 27138.8 27321.5 38316.6 48301.8 48886.5 49010.5 49376.3 30740.8 39773.0 39910.0 39956.6 41337.0 36281.5 38396.2 39403.8 40142.6 41242.6 37933.0 38400.6 38431.0 39282.0 39380.6 33482.8 34936.0 35337.1 35569.8 36368.6 25137.5 25359.9 25868.4 26091.6 26168.2 16:33:53 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | [#2] jquery.html Cycles:180 Average:35930.47 Median:347.19 stddev:105384.72 (30353.6%) stddev-sans-first:105646.45 16:33:53 INFO - PROCESS | 2006 | Values: 330.7 363.6 370.5 376.2 395.9 17548.3 17622.8 21002.7 21095.5 21480.0 20585.8 20811.6 21227.8 21281.8 21580.4 5955.6 6016.8 6023.3 6135.7 6205.2 4241.4 6013.9 6139.8 6153.9 6564.3 5411.0 6784.9 6801.7 6901.1 6907.9 6069.5 6623.6 6675.2 6817.1 6864.0 5074.6 5880.5 5914.2 5927.7 5937.2 13182.9 13660.7 13753.4 13771.8 17627.0 2141.4 2332.6 2352.4 2601.4 2633.2 10229.6 10570.8 10590.5 10933.9 15743.6 1793.6 1811.3 1849.0 1880.0 1903.4 122928.0 124944.0 126312.0 129118.0 129364.4 9568.3 10999.5 11483.4 11661.2 11959.2 14481.2 14576.9 14705.9 14706.6 14736.0 8301.7 8524.7 8554.1 8644.0 8671.6 7803.5 7899.4 7992.7 8521.4 8699.1 4497.0 4565.5 4609.3 4666.5 4674.9 1882.2 1926.7 1930.2 3718.7 3918.6 840.9 905.4 930.9 973.2 999.3 20833.5 21338.8 21742.6 22427.7 22572.9 781.8 803.0 851.2 1001.4 1055.0 11220.9 11544.5 11545.8 11650.8 11650.9 616887.0 617595.0 626086.0 645392.0 653940.0 71852.0 116700.0 124359.0 140990.3 141087.0 978.9 994.3 1024.6 1044.8 1046.3 15136.0 18832.6 19538.9 19562.8 19590.1 47862.5 53238.4 59041.7 59277.1 59588.1 81743.0 82077.6 82495.6 83652.0 85474.0 7948.4 7964.3 8116.5 8158.2 8269.6 9677.9 12123.6 12443.0 12593.0 12740.9 9679.0 9690.6 10021.3 10115.2 11223.3 9843.5 9873.7 10682.4 10867.9 10890.6 11314.0 11613.2 11636.5 11645.6 11795.0 7173.7 7201.3 7345.6 7432.6 8316.5 9389.4 10397.5 10778.7 11247.8 11492.7 16:33:53 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | [#3] mootools.html Cycles:180 Average:5730.11 Median:4911.70 stddev:3273.51 (66.6%) stddev-sans-first:3267.32 16:33:53 INFO - PROCESS | 2006 | Values: 1508.9 1543.2 1687.8 1706.7 1714.7 7540.2 8514.2 8664.2 9015.5 9034.7 8645.9 8848.6 8860.6 8868.2 8913.5 2095.2 2256.9 2366.1 2370.9 2384.6 2335.7 2374.6 2385.6 2390.5 2396.8 2369.5 2375.2 2380.9 2387.1 2388.7 2336.5 2357.4 2361.1 2366.2 2376.4 2244.6 2345.5 2348.0 2351.1 2354.9 8936.0 8970.0 8984.5 8986.5 9007.5 5145.2 5279.7 5376.6 5398.6 5413.3 2944.7 3205.7 3252.1 3608.5 3686.7 934.5 986.8 991.6 1020.2 1050.5 11553.8 11639.7 11738.0 11744.6 11783.7 4154.0 4623.2 4654.7 4860.3 4866.1 9851.8 9924.8 9929.4 9946.5 9952.6 5304.9 5341.5 5371.9 5372.0 5372.5 4447.5 4791.7 4892.2 4931.2 4950.0 3664.2 3879.3 3949.8 4018.5 4058.3 1199.7 1298.3 1303.2 1306.3 1315.8 918.6 935.6 938.1 941.8 978.3 5837.2 5930.7 6065.4 6165.3 6180.8 433.1 439.7 451.2 458.9 459.3 3994.9 3999.6 4056.6 4062.7 4133.9 10653.4 10965.8 11011.3 11064.0 11085.4 8748.2 11026.8 11056.5 11111.9 11165.3 8331.3 8403.8 8422.3 8440.0 8487.5 5750.3 5853.2 5973.9 5983.5 6025.2 9873.0 10225.4 10228.5 10262.1 10277.2 10437.2 10443.3 10446.4 10447.9 10490.0 6908.4 6912.5 7582.9 7639.2 7952.5 6511.5 8601.0 8601.6 8619.1 8632.3 7496.7 7501.4 7571.8 7606.2 7618.9 7362.9 7395.3 7406.8 7416.7 7516.7 5968.7 7012.9 7070.0 7082.8 7163.5 4071.9 4218.6 4668.3 4994.7 5384.9 5034.1 5174.2 5210.4 5237.5 5262.9 16:33:53 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | [#4] prototype.html Cycles:180 Average:4721.77 Median:5400.78 stddev:1500.88 (27.8%) stddev-sans-first:1468.04 16:33:53 INFO - PROCESS | 2006 | Values: 306.3 307.3 312.2 316.7 317.8 5581.6 5587.4 5592.2 5615.0 5651.3 4745.9 5472.6 5499.1 5571.9 5589.7 3698.8 4008.3 4148.9 4186.1 4255.3 3477.0 4182.4 4188.9 4202.0 4223.9 3731.7 4029.3 4196.2 4216.9 4236.6 3282.0 4055.7 4198.2 4205.0 4234.2 2948.8 3506.7 3586.8 3602.8 3603.2 4433.4 4957.4 5403.0 5412.8 5421.9 4255.8 4644.7 4823.3 4826.9 4848.1 4635.8 4797.3 5480.0 5652.9 5880.4 3977.5 3999.4 4002.3 4005.8 4019.8 5737.3 6081.3 6101.4 6143.9 6181.8 3255.5 3416.8 4036.6 4079.6 4086.5 4108.5 4151.7 4159.3 4163.0 4177.7 4261.6 4374.6 4833.7 4843.9 4862.6 5398.6 5858.9 5898.6 5919.9 5925.2 1139.9 1163.0 1182.8 1399.6 1400.2 789.8 790.9 833.4 849.7 864.5 4833.9 4883.5 5006.6 5221.5 5485.2 5093.5 5141.7 5204.7 6122.2 6134.2 4620.5 5196.8 5465.5 5482.3 5491.5 2532.7 2640.7 3184.7 3231.3 3232.5 5474.7 6215.9 6273.6 6322.8 6354.3 5390.8 6016.8 6173.9 6207.6 6246.9 6030.8 6097.5 6225.9 6346.8 6356.1 5630.5 6001.0 6079.8 6107.8 6116.8 5946.1 5995.3 6005.9 6030.6 6054.2 5309.5 5856.5 6307.0 6311.5 6315.3 3826.9 3939.3 3940.7 3953.2 3989.4 6045.8 6053.9 6094.5 6097.9 6112.8 5149.7 5258.4 5874.9 5894.6 5904.9 5610.8 5817.9 5829.1 5832.2 5900.0 5718.6 5791.6 5795.8 5821.3 5840.6 4947.9 5554.0 5558.2 5558.9 5566.9 4975.5 5667.4 5751.3 5804.8 5808.4 16:33:53 INFO - PROCESS | 2006 | 16:33:53 INFO - PROCESS | 2006 | [#5] yui.html Cycles:180 Average:26289.84 Median:24088.70 stddev:43056.58 (178.7%) stddev-sans-first:43134.58 16:33:53 INFO - PROCESS | 2006 | Values: 726.1 761.9 805.5 807.5 832.4 16181.7 16192.3 16206.4 16406.0 16434.8 14643.6 14704.9 14732.1 14751.3 14763.4 665.9 676.9 846.2 866.2 870.8 852.0 868.3 871.0 873.3 873.9 908.4 917.8 921.3 921.6 921.6 881.7 910.8 913.7 914.2 914.9 668.6 678.3 679.6 681.2 682.1 15103.9 15133.5 15173.2 15179.8 15192.5 12107.8 15024.5 15109.7 15166.8 15166.9 11997.5 12228.1 12300.0 12494.2 12660.1 3902.4 3926.8 4067.8 4097.7 4098.6 105410.9 122361.4 122766.0 123513.0 123617.0 11540.9 11565.9 11580.2 11605.4 12066.7 19744.0 21739.7 22300.7 24065.5 24111.9 8294.5 8381.6 8444.7 8617.7 8722.9 3826.7 4445.4 4537.7 4629.7 4803.0 3601.5 3703.6 3723.0 3723.6 3727.3 608.6 639.8 648.8 650.3 662.2 625.1 650.3 667.6 688.8 696.7 7851.6 9351.8 9483.8 9689.3 9780.5 542.6 685.1 697.2 699.6 701.4 4304.8 4546.8 4816.1 4852.8 4873.4 73785.0 127352.4 163334.0 168067.0 174687.0 144432.0 148580.0 149693.0 150405.5 151852.0 118571.0 120293.0 120951.0 122649.3 123265.3 9213.9 9275.8 9282.4 9340.4 9451.1 65784.0 66903.7 66959.7 69458.7 71197.0 94768.0 103070.0 106188.0 106676.0 110361.8 12052.4 12367.9 12825.4 12853.2 13202.5 13245.9 13458.8 13549.5 13721.8 13982.7 12379.6 12552.4 12584.4 12777.9 13051.7 12447.0 12504.6 12585.0 12665.0 12673.2 12313.5 12351.3 12359.1 12421.1 12461.3 8750.9 10673.5 10763.0 10768.8 11023.7 10772.7 10781.2 10933.1 10999.3 11020.2 16:33:53 INFO - PROCESS | 2006 | -------- Summary: end -------- 16:33:53 INFO - PROCESS | 2006 | 16:33:54 INFO - TEST-INFO | 2006: exit 0 16:33:54 INFO - TEST-OK | dromaeo_css | took 1113248ms 16:33:54 INFO - TEST-START | kraken 16:33:54 INFO - operating with platform_type : mac_ 16:33:54 INFO - Initialising browser for kraken test... 16:33:54 INFO - TEST-INFO | started process 2012 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/tmp2gzLpj/profile http://localhost:49415/getInfo.html) 16:33:57 INFO - PROCESS | 2012 | __metrics Screen width/height:1600/1200 16:33:57 INFO - PROCESS | 2012 | colorDepth:24 16:33:57 INFO - PROCESS | 2012 | Browser inner width/height: 1024/689 16:33:57 INFO - PROCESS | 2012 | __metrics 16:33:57 ERROR - PROCESS | 2012 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 16:33:57 INFO - TEST-INFO | 2012: exit 0 16:33:57 INFO - Browser initialized. 16:33:57 INFO - Running cycle 1/1 for kraken test... 16:33:57 INFO - TEST-INFO | started process 2014 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/tmp2gzLpj/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:34:09 INFO - PROCESS | 2014 | RSS: Main: 239562752 16:34:09 INFO - PROCESS | 2014 | 16:34:12 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49415/tests/kraken/driver.html?testName=audio-beat-detection) 16:34:13 INFO - PROCESS | 2014 | RSS: Main: 252637184 16:34:13 INFO - PROCESS | 2014 | 16:34:16 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49415/tests/kraken/driver.html?testName=audio-dft) 16:34:17 INFO - PROCESS | 2014 | RSS: Main: 261410816 16:34:17 INFO - PROCESS | 2014 | 16:34:20 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49415/tests/kraken/driver.html?testName=audio-fft) 16:34:21 INFO - PROCESS | 2014 | RSS: Main: 263897088 16:34:21 INFO - PROCESS | 2014 | 16:34:23 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49415/tests/kraken/driver.html?testName=audio-oscillator) 16:34:23 INFO - PROCESS | 2014 | RSS: Main: 266285056 16:34:23 INFO - PROCESS | 2014 | 16:34:25 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49415/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:34:26 INFO - PROCESS | 2014 | RSS: Main: 266977280 16:34:26 INFO - PROCESS | 2014 | 16:34:29 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49415/tests/kraken/driver.html?testName=imaging-darkroom) 16:34:30 INFO - PROCESS | 2014 | RSS: Main: 266960896 16:34:30 INFO - PROCESS | 2014 | 16:34:33 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49415/tests/kraken/driver.html?testName=imaging-desaturate) 16:34:33 INFO - PROCESS | 2014 | RSS: Main: 267243520 16:34:33 INFO - PROCESS | 2014 | 16:34:36 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49415/tests/kraken/driver.html?testName=json-parse-financial) 16:34:37 INFO - PROCESS | 2014 | RSS: Main: 267624448 16:34:37 INFO - PROCESS | 2014 | 16:34:38 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49415/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:34:39 INFO - PROCESS | 2014 | RSS: Main: 267198464 16:34:39 INFO - PROCESS | 2014 | 16:34:41 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49415/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:34:42 INFO - PROCESS | 2014 | RSS: Main: 267247616 16:34:42 INFO - PROCESS | 2014 | 16:34:44 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49415/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:34:45 INFO - PROCESS | 2014 | RSS: Main: 267309056 16:34:45 INFO - PROCESS | 2014 | 16:34:48 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49415/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:34:48 INFO - PROCESS | 2014 | RSS: Main: 267452416 16:34:48 INFO - PROCESS | 2014 | 16:34:51 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49415/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:34:52 INFO - PROCESS | 2014 | RSS: Main: 267472896 16:34:52 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | Cycle 1(1): loaded http://localhost:49415/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49415/tests/kraken/driver.html?testName=ai-astar) 16:34:54 INFO - PROCESS | 2014 | RSS: Main: 268652544 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | __start_tp_report 16:34:54 INFO - PROCESS | 2014 | _x_x_mozilla_page_load 16:34:54 INFO - PROCESS | 2014 | _x_x_mozilla_page_load_details 16:34:54 INFO - PROCESS | 2014 | |i|pagename|runs| 16:34:54 INFO - PROCESS | 2014 | |0;ai-astar;109;116;110;119;116;116;121;143;168;153 16:34:54 INFO - PROCESS | 2014 | |1;audio-beat-detection;148;117;168;150;128;163;160;112;163;118 16:34:54 INFO - PROCESS | 2014 | |2;audio-dft;195;215;222;198;197;199;194;226;281;196 16:34:54 INFO - PROCESS | 2014 | |3;audio-fft;80;76;76;148;72;61;60;60;134;60 16:34:54 INFO - PROCESS | 2014 | |4;audio-oscillator;71;75;127;98;89;77;113;71;73;119 16:34:54 INFO - PROCESS | 2014 | |5;imaging-gaussian-blur;90;91;89;87;91;96;78;83;78;114 16:34:54 INFO - PROCESS | 2014 | |6;imaging-darkroom;94;94;96;95;107;90;133;107;149;118 16:34:54 INFO - PROCESS | 2014 | |7;imaging-desaturate;92;98;93;93;95;111;121;91;93;91 16:34:54 INFO - PROCESS | 2014 | |8;json-parse-financial;55;57;61;55;56;60;55;59;73;85 16:34:54 INFO - PROCESS | 2014 | |9;json-stringify-tinderbox;69;69;69;82;66;90;97;104;100;101 16:34:54 INFO - PROCESS | 2014 | |10;stanford-crypto-aes;86;89;87;86;90;99;80;104;97;81 16:34:54 INFO - PROCESS | 2014 | |11;stanford-crypto-ccm;157;141;152;161;149;165;158;161;157;135 16:34:54 INFO - PROCESS | 2014 | |12;stanford-crypto-pbkdf2;169;173;171;169;197;228;165;236;202;169 16:34:54 INFO - PROCESS | 2014 | |13;stanford-crypto-sha256-iterative;70;75;60;73;83;91;84;91;68;62 16:34:54 INFO - PROCESS | 2014 | __end_tp_report 16:34:54 INFO - PROCESS | 2014 | __start_cc_report 16:34:54 INFO - PROCESS | 2014 | _x_x_mozilla_cycle_collect,1046 16:34:54 INFO - PROCESS | 2014 | __end_cc_report 16:34:54 INFO - PROCESS | 2014 | __startTimestamp1471044894631__endTimestamp 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | ------- Summary: start ------- 16:34:54 INFO - PROCESS | 2014 | Number of tests: 14 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#0] ai-astar Cycles:10 Average:127.10 Median:120.00 stddev:20.25 (16.9%) stddev-sans-first:20.39 16:34:54 INFO - PROCESS | 2014 | Values: 109.0 116.0 110.0 119.0 116.0 116.0 121.0 143.0 168.0 153.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#1] audio-beat-detection Cycles:10 Average:142.70 Median:155.00 stddev:21.79 (14.1%) stddev-sans-first:23.03 16:34:54 INFO - PROCESS | 2014 | Values: 148.0 117.0 168.0 150.0 128.0 163.0 160.0 112.0 163.0 118.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#2] audio-dft Cycles:10 Average:212.30 Median:207.00 stddev:26.92 (13.0%) stddev-sans-first:27.82 16:34:54 INFO - PROCESS | 2014 | Values: 195.0 215.0 222.0 198.0 197.0 199.0 194.0 226.0 281.0 196.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#3] audio-fft Cycles:10 Average:82.70 Median:66.50 stddev:31.84 (47.9%) stddev-sans-first:33.76 16:34:54 INFO - PROCESS | 2014 | Values: 80.0 76.0 76.0 148.0 72.0 61.0 60.0 60.0 134.0 60.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#4] audio-oscillator Cycles:10 Average:91.30 Median:74.00 stddev:21.58 (29.2%) stddev-sans-first:21.61 16:34:54 INFO - PROCESS | 2014 | Values: 71.0 75.0 127.0 98.0 89.0 77.0 113.0 71.0 73.0 119.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#5] imaging-gaussian-blur Cycles:10 Average:89.70 Median:89.50 stddev:10.33 (11.5%) stddev-sans-first:10.95 16:34:54 INFO - PROCESS | 2014 | Values: 90.0 91.0 89.0 87.0 91.0 96.0 78.0 83.0 78.0 114.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#6] imaging-darkroom Cycles:10 Average:108.30 Median:92.00 stddev:19.54 (21.2%) stddev-sans-first:20.03 16:34:54 INFO - PROCESS | 2014 | Values: 94.0 94.0 96.0 95.0 107.0 90.0 133.0 107.0 149.0 118.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#7] imaging-desaturate Cycles:10 Average:97.80 Median:93.00 stddev:10.09 (10.8%) stddev-sans-first:10.48 16:34:54 INFO - PROCESS | 2014 | Values: 92.0 98.0 93.0 93.0 95.0 111.0 121.0 91.0 93.0 91.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#8] json-parse-financial Cycles:10 Average:61.60 Median:59.50 stddev:9.83 (16.5%) stddev-sans-first:10.14 16:34:54 INFO - PROCESS | 2014 | Values: 55.0 57.0 61.0 55.0 56.0 60.0 55.0 59.0 73.0 85.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#9] json-stringify-tinderbox Cycles:10 Average:84.70 Median:69.00 stddev:15.45 (22.4%) stddev-sans-first:15.31 16:34:54 INFO - PROCESS | 2014 | Values: 69.0 69.0 69.0 82.0 66.0 90.0 97.0 104.0 100.0 101.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#10] stanford-crypto-aes Cycles:10 Average:89.90 Median:88.00 stddev:7.81 (8.9%) stddev-sans-first:8.15 16:34:54 INFO - PROCESS | 2014 | Values: 86.0 89.0 87.0 86.0 90.0 99.0 80.0 104.0 97.0 81.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#11] stanford-crypto-ccm Cycles:10 Average:153.60 Median:157.50 stddev:9.49 (6.0%) stddev-sans-first:9.98 16:34:54 INFO - PROCESS | 2014 | Values: 157.0 141.0 152.0 161.0 149.0 165.0 158.0 161.0 157.0 135.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:187.90 Median:185.00 stddev:26.47 (14.3%) stddev-sans-first:27.18 16:34:54 INFO - PROCESS | 2014 | Values: 169.0 173.0 171.0 169.0 197.0 228.0 165.0 236.0 202.0 169.0 16:34:54 INFO - PROCESS | 2014 | 16:34:54 INFO - PROCESS | 2014 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:75.70 Median:79.00 stddev:11.18 (14.1%) stddev-sans-first:11.66 16:34:54 INFO - PROCESS | 2014 | Values: 70.0 75.0 60.0 73.0 83.0 91.0 84.0 91.0 68.0 62.0 16:34:54 INFO - PROCESS | 2014 | -------- Summary: end -------- 16:34:54 INFO - PROCESS | 2014 | 16:34:55 INFO - TEST-INFO | 2014: exit 0 16:34:55 INFO - TEST-OK | kraken | took 61364ms 16:34:55 INFO - SUITE-END | took 1174s 16:34:55 INFO - Completed test suite (00:19:34) 16:34:55 INFO - javascript benchmark 16:34:55 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7464.910676175593, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3404.2170300830808, 3422.777519461235, 3424.657534246576, 3435.4846772984033, 3473.5484387029683, 5802.419758024206, 5912.645241285521, 5946.167536544887, 5969.910451343228, 5999.580029397944, 5896.616719913213, 5907.438793314628, 5942.168096466498, 5948.672822994745, 6018.307894592123, 5217.243499692542, 5358.410574836765, 5401.4868587484125, 5406.83779486616, 5422.240886275925, 5217.608679349064, 5246.895062098756, 5367.06076436624, 5422.728863556826, 5439.184122381655, 5301.5228629423345, 5320.388155362144, 5344.385395679507, 5344.759485823109, 5382.596305277119, 5295.549878260353, 5322.733863306819, 5326.786928522854, 5354.785808567692, 5377.542908852753, 4695.765211739434, 5214.478552144793, 5270.6047046471285, 5274.55166310864, 5297.735113244323, 4921.532454416824, 5794.942050579524, 5896.764129434818, 5926.970365148147, 5994.55040871932, 6231.252249730016, 6290.283306250039, 6293.244810622755, 6323.588966717149, 6326.177596912418, 6147.801178770142, 6236.594621349598, 6327.620342779448, 6351.587146835441, 6365.140706004677, 5853.32686741026, 5954.136650185699, 5955.196048533479, 6027.608205466675, 6029.366916473795, 6348.555601107971, 6360.268569114611, 6407.13503677007, 6407.839804004937, 6428.903566446507, 6137.683438940261, 6202.131701561785, 6280.905786413207, 6304.991201407753, 6333.0, 6243.656598887105, 6298.968505157445, 6313.621182729051, 6322.968385158137, 6345.17512723343, 6234.189555357865, 6257.092721555349, 6269.811905642838, 6296.401841825019, 6364.459020983269, 6130.153553065287, 6208.255009398901, 6297.055441683784, 6306.463950564162, 6332.968335158294, 5001.64988450805, 5035.0, 5041.470645582234, 5045.445001049881, 5080.618953578496, 4488.865334039919, 4525.411696479437, 4526.569975852289, 4551.544845515488, 4559.498455169929, 5866.149408335853, 5996.940030599725, 6009.729562169713, 6070.696465176724, 6109.0, 6312.652804095727, 6314.0528920661345, 6333.746650133943, 6349.365063493706, 6353.5870168438905, 6067.544934129958, 6073.6659483727935, 6073.939260607426, 6082.239720034996, 6092.543059270483, 5438.8912221755345, 5495.670259784426, 5518.806841760519, 5584.832455026356, 5602.075657516546, 6379.776707815297, 6474.99637556189, 6487.643179625166, 6498.122753428322, 6504.447121994494, 6260.499160067093, 6273.309935906956, 6301.905471417841, 6322.083297921868, 6330.556861019684, 6285.340039295808, 6329.145565348803, 6386.712597933011, 6471.2234531856475, 6480.805575832733, 6218.315985241529, 6304.211973503312, 6305.90541141874, 6316.873662526816, 6317.30509643948, 6115.174451448997, 6288.151099601495, 6288.339724328879, 6292.905606415816, 6303.747850085945, 6126.27339965311, 6192.628442293477, 6217.067439884054, 6264.436200741955, 6283.8114856554375, 6210.472109870531, 6261.530385221035, 6273.905891411724, 6273.96863015682, 6288.905666414916, 5895.793647222326, 6084.39156084388, 6168.136460895568, 6177.351378105234, 6177.413145751147, 6064.727087281171, 6153.630782153085, 6234.844128896814, 6268.153799237227, 6269.373062693694, 6083.0, 6152.538559607958, 6180.443760061616, 6186.597871138361, 6193.977993631001], "value": 5828.778801720777, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [503.3808415648753, 529.8940211957608, 539.5818240863327, 543.3099963046931, 564.5257983294032, 26460.470790584175, 33723.15692107699, 41241.0, 41382.793086034566, 41439.37840932381, 35430.468542971874, 42659.3601095983, 42811.57188428115, 42893.142137157316, 43671.689849304494, 8359.665613375457, 9645.373050751696, 9830.459324737136, 9841.26190535709, 9874.40753554789, 8370.414071015031, 8874.467531948072, 9704.757381065494, 9836.163926066292, 9846.60613575456, 7847.843043139133, 9791.853122203172, 9829.311948163631, 9841.065098815638, 9854.458004809732, 9806.215502759798, 9817.50912454378, 9831.852522212173, 9832.606695732162, 9840.606375744961, 9594.856077158849, 9608.991055939096, 9649.083337082966, 9656.179224765903, 9685.467299298536, 40411.595884041075, 40566.18867622661, 40670.186596268206, 40702.185956281006, 40720.79639601813, 3049.3407166447273, 3422.640622734602, 3456.844442000091, 3560.893173204808, 3653.2876089162623, 30444.84777576098, 31964.04107876744, 32477.350452991042, 32704.6729532704, 32793.50809737856, 3274.918127046819, 3376.459766437358, 3416.419208734521, 3445.3453843769603, 3460.653934606519, 516492.0, 520388.0, 525387.0, 526614.0, 528694.3565282149, 54008.45991540113, 62009.68995154995, 62699.0, 63486.682566586875, 63718.0, 65405.0, 65493.67253163799, 65520.0, 66136.66931665406, 66184.33815661877, 16185.59536011609, 16201.189940502927, 16282.83717162837, 16354.0, 16375.59061023484, 12380.257184568954, 12432.502699891904, 12537.059720520998, 12590.622281331574, 12709.428075736614, 18833.81166188348, 18954.431367058736, 18961.620767584845, 18978.52553686169, 18995.81004189968, 7838.764837054898, 7961.601919903982, 7961.960190199012, 8009.879851802228, 8022.919770802334, 862.7066797288952, 904.2720609908955, 987.5950860147449, 1008.5965613754557, 1145.959891403797, 25240.368990775376, 30417.327047012182, 30822.845885770876, 31094.378112438077, 31434.528482072787, 1119.960801371948, 1137.419915842926, 1142.5886680794906, 1154.6420609611048, 1199.7000749812546, 15599.06405615644, 15831.366745330059, 15980.360785568679, 16116.677666446605, 16251.431199907947, 657675.0, 727339.0, 728223.0, 728224.0, 729878.0, 59928.40071599316, 60601.78796424135, 60609.0, 60610.0, 60677.0, 1333.6399172223446, 1359.4018631801976, 1398.0, 1398.8181536400202, 1400.7828786538103, 29609.703902960693, 30714.232144196572, 30718.84640576783, 30996.845015774776, 31264.0, 50717.746411267704, 51084.744576276884, 51252.0, 51323.0, 51407.71480712863, 602337.0, 603871.0, 604077.0, 605782.9132563103, 606329.0, 26734.06430774991, 26961.0, 26986.1904142876, 27138.778754955678, 27321.45357092887, 38316.61683383131, 48301.75849120732, 48886.5111348882, 49010.50989490202, 49376.25935610897, 30740.846295768377, 39773.0, 39910.0, 39956.600433995285, 41337.0, 36281.45577816388, 38396.23207535778, 39403.80298098491, 40142.598574013886, 41242.58757412388, 37933.0, 38400.615993840824, 38431.0, 39282.0, 39380.606193937696, 33482.83258583691, 34935.9519214424, 35337.11657208487, 35569.82215088908, 36368.63631363758, 25137.49725005526, 25359.87320063388, 25868.35329116787, 26091.60862587025, 26168.21495355066], "value": 20352.305833088383, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [330.7321069933353, 363.64907863911304, 370.49982523593155, 376.2324857291123, 395.8934777297453, 17548.298068077278, 17622.82377176228, 21002.684959725597, 21095.47261318464, 21480.0, 20585.794142058574, 20811.583768324625, 21227.787722122775, 21281.787182128173, 21580.352589422302, 5955.612885162462, 6016.789412370568, 6023.30731965823, 6135.6625385603775, 6205.22434695663, 4241.448611680477, 6013.939860601404, 6139.815805525842, 6153.876922461548, 6564.277929427759, 5410.972945135269, 6784.898226526606, 6801.693923773442, 6901.137357830271, 6907.861842763142, 6069.514438844926, 6623.635700036496, 6675.232348279961, 6817.0796942412635, 6864.039034535169, 5074.619403544749, 5880.529557635422, 5914.2015827863115, 5927.703614819285, 5937.198478205473, 13182.86817131826, 13660.65848353789, 13753.449862005507, 13771.793423098661, 17627.0, 2141.4325203821, 2332.591796435617, 2352.364861487406, 2601.4016776141593, 2633.2231991562535, 10229.64196253135, 10570.841437378445, 10590.517327574145, 10933.945330273376, 15743.606409839846, 1793.6054068104995, 1811.2754898040757, 1848.9907550462162, 1879.9718004229946, 1903.3528600275972, 122928.0, 124944.0, 126312.0, 129118.0, 129364.3531782335, 9568.282378821616, 10999.505022274017, 11483.420942178122, 11661.24201926872, 11959.162858599988, 14481.203533805741, 14576.927115364355, 14705.852941470663, 14706.558803235706, 14736.042157259744, 8301.709440169565, 8524.70163544273, 8554.05905350411, 8643.956780216058, 8671.609777560025, 7803.453758236869, 7899.368050555941, 7992.68029278834, 8521.446106003214, 8699.086595907465, 4497.0, 4565.474970378449, 4609.285560738091, 4666.533346665306, 4674.883127921829, 1882.162437715231, 1926.6724656808376, 1930.2182616040527, 3718.6839118674675, 3918.647321741057, 840.8774286327699, 905.4150400606175, 930.930180236485, 973.1582181413169, 999.2855108597388, 20833.479163021046, 21338.78661213399, 21742.565148697253, 22427.663585046237, 22572.88713556422, 781.819452626538, 802.955837428947, 851.212628318815, 1001.4477559782308, 1054.97667262755, 11220.887791122148, 11544.538218471334, 11545.826812597817, 11650.766984660258, 11650.88349116515, 616887.0, 617595.0, 626086.0, 645392.0, 653940.0, 71852.0, 116700.0, 124359.0, 140990.2950485241, 141087.0, 978.9363691360039, 994.3487016004528, 1024.5594394410475, 1044.8380501022202, 1046.3303485769113, 15136.0, 18832.62334753325, 19538.90230548838, 19562.804371956667, 19590.11844467031, 47862.52137478581, 53238.40284791462, 59041.704791475764, 59277.11084333652, 59588.106178406495, 81743.0, 82077.58961205155, 82495.58752206201, 83652.0, 85474.0, 7948.3641308694005, 7964.283214510722, 8116.513009219466, 8158.224968627971, 8269.62786674589, 9677.9032209677, 12123.636290911287, 12443.0, 12593.0, 12740.917022053229, 9679.032096790264, 9690.56392462355, 10021.298509104292, 10115.241356898408, 11223.270487418291, 9843.523471479335, 9873.654422095193, 10682.412467314372, 10867.945660271647, 10890.61882834097, 11314.0, 11613.187076904536, 11636.476358563716, 11645.59240426581, 11795.0, 7173.7489187880265, 7201.279872012757, 7345.595992220479, 7432.591207483641, 8316.501009939422, 9389.43663380172, 10397.480125993821, 10778.73053173677, 11247.775044499227, 11492.655220343404], "value": 9604.57614218494, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1508.939642414303, 1543.174401695093, 1687.7805885234918, 1706.7269236922086, 1714.7256438969766, 7540.245975402457, 8514.191151840572, 8664.220220180197, 9015.45907245565, 9034.68378606748, 8645.913540864589, 8848.557572121385, 8860.601272942717, 8868.201861832435, 8913.548774087129, 2095.19335056003, 2256.909723611054, 2366.148186652804, 2370.8933098010543, 2384.582698027847, 2335.7313908900437, 2374.560706269337, 2385.5705972924866, 2390.4740956989435, 2396.8442051266697, 2369.490559529701, 2375.192434572245, 2380.880955952204, 2387.140629373424, 2388.677528533643, 2336.5210131923086, 2357.422431504284, 2361.1499860050367, 2366.2428023032635, 2376.3583832365252, 2244.5847518209184, 2345.5074434368803, 2347.953040939172, 2351.106579499796, 2354.8704821234996, 8936.0, 8969.968453627785, 8984.46093234408, 8986.505742184178, 9007.549622518847, 5145.202493613496, 5279.656822306538, 5376.569874410077, 5398.568114550826, 5413.26920865682, 2944.6613639431525, 3205.7114859662743, 3252.10567094051, 3608.5308909841815, 3686.7234957378037, 934.4953724988566, 986.8174387738292, 991.6330957545682, 1020.1583693452857, 1050.5482642463737, 11553.844615538463, 11639.6508104757, 11738.002269807077, 11744.647660570197, 11783.7054073648, 4153.979230103831, 4623.190941585276, 4654.697444666086, 4860.343853579792, 4866.124097662384, 9851.753706157404, 9924.80150396988, 9929.404235745878, 9946.452945087945, 9952.552135153936, 5304.92042619361, 5341.465853414627, 5371.865703357369, 5372.0, 5372.462753724674, 4447.466304043535, 4791.736454494967, 4892.19278818998, 4931.211006239057, 4949.975250123726, 3664.212194378168, 3879.321118804198, 3949.822257998397, 4018.517777866675, 4058.3100872851687, 1199.6640940536663, 1298.318382848993, 1303.2115570080155, 1306.3468265867066, 1315.8026296055477, 918.6233644205977, 935.6397786852111, 938.0853667673963, 941.7692665297046, 978.3102912446708, 5837.241158649348, 5930.695247045643, 6065.363136870653, 6165.260168779775, 6180.752769889244, 433.1186036415941, 439.7185801087307, 451.22839943695993, 458.9013362127159, 459.3110334498253, 3994.9201015979515, 3999.560048394674, 4056.6146216109423, 4062.7156099073372, 4133.91732165355, 10653.414062226651, 10965.793762686098, 11011.339319640847, 11064.004239618473, 11085.390303533222, 8748.212660860552, 11026.834597481044, 11056.502457389437, 11111.888881111085, 11165.274257173258, 8331.250187483156, 8403.789905252417, 8422.326213902874, 8439.987201535732, 8487.533185674847, 5750.309962804323, 5853.2390789198835, 5973.940260597338, 5983.491403230774, 6025.18659980897, 9872.950635246778, 10225.386476811414, 10228.53971571296, 10262.127719143957, 10277.229207809294, 10437.165026797686, 10443.321184123008, 10446.42544660051, 10447.94776026115, 10490.0, 6908.447324214151, 6912.4815638828295, 7582.924170758221, 7639.236076392316, 7952.483088599222, 6511.479081673549, 8601.010883748198, 8601.612927418406, 8619.051904290398, 8632.266257367943, 7496.700131994878, 7501.437392195717, 7571.810704732426, 7606.20134885829, 7618.923810761821, 7362.852742945004, 7395.334419902235, 7406.777796666109, 7416.66625001887, 7516.699332026657, 5968.671723055274, 7012.859742805013, 7070.0, 7082.752103676346, 7163.498555101093, 4071.89820254496, 4218.620324170839, 4668.323093151406, 4994.675346102492, 5384.865378365572, 5034.144195486703, 5174.197999310113, 5210.426853046238, 5237.528622424, 5262.89474210506], "value": 4508.274978808287, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [306.2619087997925, 307.2503092454411, 312.2116655445002, 316.6595909397398, 317.8013741411618, 5581.6371935824145, 5587.357453892803, 5592.217089607448, 5614.971925140374, 5651.265335506384, 4745.857624271269, 5472.589555783312, 5499.085484693109, 5571.944280557193, 5589.664620122796, 3698.7595806272507, 4008.2785098682225, 4148.875533733993, 4186.1418409226035, 4255.276602977486, 3476.9826150869335, 4182.372644103379, 4188.937165942513, 4201.995573165186, 4223.936640950388, 3731.6641502264793, 4029.2948733971584, 4196.181744559812, 4216.915661686764, 4236.555161708023, 3281.967180328214, 4055.675545956331, 4198.202341555095, 4205.0, 4234.195502854448, 2948.778841586868, 3506.73699472538, 3586.7668601540818, 3602.837872295753, 3603.1712706077487, 4433.357163211349, 4957.355543779322, 5402.9729851350885, 5412.83761487156, 5421.864453388657, 4255.765827909902, 4644.674872758908, 4823.252395878644, 4826.927596086061, 4848.127337079324, 4635.8377456789185, 4797.337477699875, 5479.972600137014, 5652.925944070614, 5880.353840771627, 3977.4630424892557, 3999.42008408782, 4002.2595819773437, 4005.7782376375194, 4019.77891215983, 5737.254156959569, 6081.300650425169, 6101.359357267467, 6143.907841382383, 6181.845453863644, 3255.544223808669, 3416.79499230047, 4036.59634036594, 4079.6129316032693, 4086.4891888513935, 4108.50697916246, 4151.6886233532605, 4159.251334759711, 4163.042500224965, 4177.720489415794, 4261.637760790306, 4374.606285434326, 4833.709977401297, 4843.948312563063, 4862.586680132157, 5398.595105367113, 5858.882822343615, 5898.616589921641, 5919.852003699942, 5925.200097986803, 1139.9145064120223, 1162.9709257268466, 1182.8225766134976, 1399.5591388712523, 1400.2298735695326, 789.7995047527726, 790.8932294140333, 833.3791325462569, 849.7068511363569, 864.4856310495245, 4833.9033219335415, 4883.511648835088, 5006.598152517301, 5221.530062294336, 5485.232067510552, 5093.516115968977, 5141.71720555373, 5204.713740744295, 6122.234720659918, 6134.171886795315, 4620.491745908014, 5196.778756992104, 5465.535429488458, 5482.259894914136, 5491.478309560585, 2532.683414573178, 2640.683118025849, 3184.7292980096486, 3231.3052693670975, 3232.5453545903965, 5474.698891560923, 6215.9378406216265, 6273.560850740404, 6322.841928951813, 6354.269259035178, 5390.787072908564, 6016.819495415145, 6173.931732869449, 6207.5654704171175, 6246.906296405557, 6030.758769649165, 6097.481714054266, 6225.875482490415, 6346.809595712136, 6356.078368636522, 5630.465105814941, 6000.969995149996, 6079.787207447718, 6107.786227482017, 6116.785912493041, 5946.097248880316, 5995.250593675791, 6005.87988240224, 6030.638161710312, 6054.182685337423, 5309.513336265852, 5856.472917437451, 6306.9684651576445, 6311.463525600192, 6315.252865003555, 3826.8710730335174, 3939.2515422069714, 3940.665043471337, 3953.2093581284435, 3989.4414781929972, 6045.818625441244, 6053.878922421615, 6094.451499365078, 6097.908531371944, 6112.847178820387, 5149.742512874416, 5258.448757616588, 5874.853128671817, 5894.646321220741, 5904.852378690567, 5610.811783404557, 5817.883642327214, 5829.09649004405, 5832.212651292191, 5900.026495628345, 5718.570357410647, 5791.623544469596, 5795.76816927335, 5821.27234095738, 5840.591158619026, 4947.925781113214, 5554.0, 5558.166275058612, 5558.861028474321, 5566.888662226814, 4975.512243878061, 5667.3765885753355, 5751.252337196138, 5804.751978324681, 5808.419158084158], "value": 4228.813948579866, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [726.0960104669687, 761.9047619047619, 805.53681633061, 807.5195258821001, 832.421467080379, 16181.676366472679, 16192.271347789349, 16206.35174593015, 16406.015639061665, 16434.835651643494, 14643.633909152277, 14704.852951470482, 14732.116073035599, 14751.26243687814, 14763.409463621443, 665.9001149827516, 676.8510927595945, 846.1834329871673, 866.2377108144824, 870.8258348330328, 851.9957400212991, 868.3096937934325, 870.9564521773917, 873.3188113271658, 873.8995015573195, 908.3959167153835, 917.8393781088316, 921.299812142773, 921.6267411698273, 921.6451666108529, 881.7487016200353, 910.7586489580233, 913.712180663089, 914.1818072824784, 914.9359544831865, 668.6055227415848, 678.3352314731542, 679.5854528737516, 681.2131987554333, 682.0962225051777, 15103.924480377638, 15133.54599362021, 15173.24133793317, 15179.772303415457, 15192.544223673307, 12107.818382724266, 15024.549263522113, 15109.697806043927, 15166.848331516765, 15166.924165379212, 11997.46011429479, 12228.144029917908, 12300.0, 12494.187877788005, 12660.050496212822, 3902.3951287550476, 3926.823292951824, 4067.7966101694797, 4097.733647312945, 4098.631123198897, 105410.94589054164, 122361.38819305935, 122766.0, 123513.0, 123617.0, 11540.884591154148, 11565.884341156649, 11580.247283926517, 11605.361705106132, 12066.698332541757, 19744.0, 21739.67390489144, 22300.661960282436, 24065.51868962611, 24111.879440602686, 8294.543800091053, 8381.622826972802, 8444.704435344733, 8617.741467755977, 8722.86915696265, 3826.693864490834, 4445.3998710174355, 4537.682362234612, 4629.722216667011, 4802.991371811959, 3601.5318008659233, 3703.5555733312176, 3723.0134014486184, 3723.553173619183, 3727.2731817295366, 608.5861614102364, 639.7888696730068, 648.7826578096297, 650.3204151661525, 662.2351184382046, 625.1435533319382, 650.3236633900785, 667.5727534378002, 688.8358673841192, 696.6969368324795, 7851.646675899598, 9351.766205844908, 9483.762905927408, 9689.25593393182, 9780.510974451392, 542.6066102076043, 685.1127789512593, 697.1625484278936, 699.5662689132669, 701.4248316380621, 4304.83769382265, 4546.795394207269, 4816.109019831272, 4852.80588776445, 4873.366462359942, 73785.0, 127352.36323818506, 163334.0, 168067.0, 174687.0, 144432.0, 148580.0, 149693.0, 150405.49594504133, 151852.0, 118571.0, 120293.0, 120951.0, 122649.34831191023, 123265.30204093891, 9213.86179207299, 9275.840519935007, 9282.396644218104, 9340.392874463138, 9451.091624552975, 65784.0, 66903.66548167422, 66959.66520167563, 69458.65270673615, 71197.0, 94768.0, 103069.96930030604, 106188.0, 106676.0, 110361.79276414587, 12052.397380131133, 12367.9381603095, 12825.358732063172, 12853.228806271654, 13202.537911173447, 13245.933770331087, 13458.798118028433, 13549.458021679417, 13721.779301095536, 13982.650433739238, 12379.616364215275, 12552.372381381078, 12584.370781460708, 12777.93611031939, 13051.673708157372, 12447.0, 12504.624861254177, 12585.0, 12665.0, 12673.17624354414, 12313.538908089917, 12351.25892446456, 12359.134860559674, 12421.068419868365, 12461.314627695563, 8750.912490875264, 10673.46632668348, 10763.0, 10768.838467422838, 11023.669289921316, 10772.730681733019, 10781.19141064439, 10933.125349972142, 10999.285046471954, 11020.228583999044], "value": 7965.3301116932835, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1605.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 116.0, 110.0, 119.0, 116.0, 116.0, 121.0, 143.0, 168.0, 153.0], "value": 127.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 117.0, 168.0, 150.0, 128.0, 163.0, 160.0, 112.0, 163.0, 118.0], "value": 142.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [195.0, 215.0, 222.0, 198.0, 197.0, 199.0, 194.0, 226.0, 281.0, 196.0], "value": 212.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 76.0, 76.0, 148.0, 72.0, 61.0, 60.0, 60.0, 134.0, 60.0], "value": 82.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 75.0, 127.0, 98.0, 89.0, 77.0, 113.0, 71.0, 73.0, 119.0], "value": 91.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 91.0, 89.0, 87.0, 91.0, 96.0, 78.0, 83.0, 78.0, 114.0], "value": 89.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 96.0, 95.0, 107.0, 90.0, 133.0, 107.0, 149.0, 118.0], "value": 108.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 98.0, 93.0, 93.0, 95.0, 111.0, 121.0, 91.0, 93.0, 91.0], "value": 97.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 57.0, 61.0, 55.0, 56.0, 60.0, 55.0, 59.0, 73.0, 85.0], "value": 61.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 69.0, 69.0, 82.0, 66.0, 90.0, 97.0, 104.0, 100.0, 101.0], "value": 84.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 89.0, 87.0, 86.0, 90.0, 99.0, 80.0, 104.0, 97.0, 81.0], "value": 89.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 141.0, 152.0, 161.0, 149.0, 165.0, 158.0, 161.0, 157.0, 135.0], "value": 153.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 173.0, 171.0, 169.0, 197.0, 228.0, 165.0, 236.0, 202.0, 169.0], "value": 187.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 75.0, 60.0, 73.0, 83.0, 91.0, 84.0, 91.0, 68.0, 62.0], "value": 75.7, "unit": "score"}]}]} 16:34:55 INFO - Return code: 0 16:34:55 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:34:55 ERROR - # TBPL SUCCESS # 16:34:55 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:34:55 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:34:55 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:34:55 INFO - 2016-08-12 16:34:55.984 screenresolution[2019:14108] starting screenresolution argv=screenresolution get 16:34:55 INFO - 2016-08-12 16:34:55.988 screenresolution[2019:14108] Display 0: 1600x1200x32@60 16:34:55 INFO - 2016-08-12 16:34:55.995 screenresolution[2020:14111] starting screenresolution argv=screenresolution list 16:34:55 INFO - Available Modes on Display 0 16:34:55 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:34:55 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:34:55 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:34:55 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:34:56 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:34:56 INFO - Intel Iris: 16:34:56 INFO - Chipset Model: Intel Iris 16:34:56 INFO - Type: GPU 16:34:56 INFO - Bus: Built-In 16:34:56 INFO - VRAM (Dynamic, Max): 1536 MB 16:34:56 INFO - Vendor: Intel (0x8086) 16:34:56 INFO - Device ID: 0x0a2e 16:34:56 INFO - Revision ID: 0x0009 16:34:56 INFO - Displays: 16:34:56 INFO - Display: 16:34:56 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:34:56 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:34:56 INFO - Display Serial Number: 1600x1200 60 16:34:56 INFO - Main Display: Yes 16:34:56 INFO - Mirror: Off 16:34:56 INFO - Online: Yes 16:34:56 INFO - Rotation: Supported 16:34:56 INFO - Return code: 0 16:34:56 INFO - Running post-action listener: _resource_record_post_action 16:34:56 INFO - [mozharness: 2016-08-12 23:34:56.233927Z] Finished run-tests step (success) 16:34:56 INFO - Running post-run listener: _resource_record_post_run 16:34:56 INFO - Total resource usage - Wall time: 1210s; CPU: 54.0%; Read bytes: 405504; Write bytes: 707251200; Read time: 9; Write time: 1958 16:34:56 INFO - TinderboxPrint: CPU usage
54.3% 16:34:56 INFO - TinderboxPrint: I/O read bytes / time
405,504 / 9 16:34:56 INFO - TinderboxPrint: I/O write bytes / time
707,251,200 / 1,958 16:34:56 INFO - TinderboxPrint: CPU idle
2,212.3 (45.7%) 16:34:56 INFO - TinderboxPrint: CPU system
975.7 (20.2%) 16:34:56 INFO - TinderboxPrint: CPU user
1,653.7 (34.2%) 16:34:56 INFO - TinderboxPrint: Swap in / out
405,241,856 / 0 16:34:56 INFO - install - Wall time: 35s; CPU: 54.0%; Read bytes: 391784960; Write bytes: 386651648; Read time: 29414; Write time: 720 16:34:56 INFO - run-tests - Wall time: 1176s; CPU: 54.0%; Read bytes: 397312; Write bytes: 298518016; Read time: 9; Write time: 1189 16:34:56 INFO - Running post-run listener: _upload_blobber_files 16:34:56 INFO - Blob upload gear active. 16:34:56 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:34:56 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:34:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:34:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:34:57 INFO - (blobuploader) - INFO - Open directory for files ... 16:34:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:34:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:34:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:34:57 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:34:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:34:57 INFO - (blobuploader) - INFO - Done attempting. 16:34:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:34:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:34:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:34:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:34:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:34:58 INFO - (blobuploader) - INFO - Done attempting. 16:34:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:34:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:34:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:35:01 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:35:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:35:01 INFO - (blobuploader) - INFO - Done attempting. 16:35:01 INFO - (blobuploader) - INFO - Iteration through files over. 16:35:01 INFO - Return code: 0 16:35:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:35:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:35:01 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4a4b278cae79423084ec8fbfdcce81b300d18aea36780d36af01f22103638ab45072d9bd8b4841667b7dfc52e8281de29723c5dccadb84c8486c2d8bb55852e9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0dab355b927373fa42d023e879c4603130c9e250279b885ec9325bf5e71155b6f37126bc7e15aa58863ce77d5419352f94cb5fdd4702e6d1f1b2ee83e600b9c6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/98c128cb3d81156ce034f32e14bce0e20328716402344802776f0a2d61651fcb904b8021e1290a646ff69700854d9f77d6bc432bff0116cf09420b3e7e6d6c14"} 16:35:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:35:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:35:01 INFO - Contents: 16:35:01 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4a4b278cae79423084ec8fbfdcce81b300d18aea36780d36af01f22103638ab45072d9bd8b4841667b7dfc52e8281de29723c5dccadb84c8486c2d8bb55852e9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0dab355b927373fa42d023e879c4603130c9e250279b885ec9325bf5e71155b6f37126bc7e15aa58863ce77d5419352f94cb5fdd4702e6d1f1b2ee83e600b9c6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/98c128cb3d81156ce034f32e14bce0e20328716402344802776f0a2d61651fcb904b8021e1290a646ff69700854d9f77d6bc432bff0116cf09420b3e7e6d6c14"} 16:35:01 INFO - Running post-run listener: copy_logs_to_upload_dir 16:35:01 INFO - Copying logs to upload dir... 16:35:01 INFO - mkdir: /builds/slave/test/build/upload/logs 16:35:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1272.278177 ========= master_lag: 0.06 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 12 secs) (at 2016-08-12 16:35:01.277688) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-12 16:35:01.280961) ========= 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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners TMPDIR=/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4a4b278cae79423084ec8fbfdcce81b300d18aea36780d36af01f22103638ab45072d9bd8b4841667b7dfc52e8281de29723c5dccadb84c8486c2d8bb55852e9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0dab355b927373fa42d023e879c4603130c9e250279b885ec9325bf5e71155b6f37126bc7e15aa58863ce77d5419352f94cb5fdd4702e6d1f1b2ee83e600b9c6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/98c128cb3d81156ce034f32e14bce0e20328716402344802776f0a2d61651fcb904b8021e1290a646ff69700854d9f77d6bc432bff0116cf09420b3e7e6d6c14"} build_url:https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011454 build_url: 'https://queue.taskcluster.net/v1/task/MAbQYSqWTIioSrrMTC2F2w/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4a4b278cae79423084ec8fbfdcce81b300d18aea36780d36af01f22103638ab45072d9bd8b4841667b7dfc52e8281de29723c5dccadb84c8486c2d8bb55852e9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0dab355b927373fa42d023e879c4603130c9e250279b885ec9325bf5e71155b6f37126bc7e15aa58863ce77d5419352f94cb5fdd4702e6d1f1b2ee83e600b9c6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/98c128cb3d81156ce034f32e14bce0e20328716402344802776f0a2d61651fcb904b8021e1290a646ff69700854d9f77d6bc432bff0116cf09420b3e7e6d6c14"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-12 16:35:01.317518) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-12 16:35:01.317894) ========= 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.8LPugtOCSQ/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.AgBOqxm2Zq/Listeners TMPDIR=/var/folders/3z/sl2t9zqs0cxgfh9f4pkbmnbh00000w/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.005249 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-12 16:35:01.368641) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-12 16:35:01.369253) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-12 16:35:01.369841) ========= ========= Total master_lag: 0.37 =========