builder: mozilla-central_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0348 starttime: 1471174001.22 results: success (0) buildid: 20160814030203 builduid: 8793c526a9c445938eb1935fff39321d revision: 6e191a55c3d23e83e6a2e72e4e80c1dc21516493 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:41.224591) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:41.225270) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:41.225554) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:41.487214) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:41.487468) ========= 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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-08-14 04:26:41-- 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% 19.9M=0.001s 2016-08-14 04:26:41 (19.9 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.171230 ========= master_lag: 0.07 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:41.723900) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:41.724243) ========= 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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.027332 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:41.788654) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-14 04:26:41.789008) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 6e191a55c3d23e83e6a2e72e4e80c1dc21516493 --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 6e191a55c3d23e83e6a2e72e4e80c1dc21516493 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.6ngpxpoJgJ/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.wa9JHVybTI/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-08-14 04:26:41,867 truncating revision to first 12 chars 2016-08-14 04:26:41,867 Setting DEBUG logging. 2016-08-14 04:26:41,867 attempt 1/10 2016-08-14 04:26:41,867 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/6e191a55c3d2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-14 04:26:42,887 unpacking tar archive at: mozilla-central-6e191a55c3d2/testing/mozharness/ program finished with exit code 0 elapsedTime=1.286331 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-14 04:26:43.098181) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:43.098489) ========= script_repo_revision: 6e191a55c3d23e83e6a2e72e4e80c1dc21516493 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:43.098915) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:43.099213) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-14 04:26:43.120438) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 14 secs) (at 2016-08-14 04:26:43.120827) ========= /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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 04:26:43 INFO - MultiFileLogger online at 20160814 04:26:43 in /builds/slave/test 04:26:43 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 04:26:43 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:26:43 INFO - {'append_to_log': False, 04:26:43 INFO - 'base_work_dir': '/builds/slave/test', 04:26:43 INFO - 'blob_upload_branch': 'Firefox', 04:26:43 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:26:43 INFO - 'branch': 'Firefox', 04:26:43 INFO - 'buildbot_json_path': 'buildprops.json', 04:26:43 INFO - 'config_files': ('talos/mac_config.py',), 04:26:43 INFO - 'default_actions': ('clobber', 04:26:43 INFO - 'read-buildbot-config', 04:26:43 INFO - 'download-and-extract', 04:26:43 INFO - 'populate-webroot', 04:26:43 INFO - 'create-virtualenv', 04:26:43 INFO - 'install', 04:26:43 INFO - 'run-tests'), 04:26:43 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:26:43 INFO - 'download_minidump_stackwalk': True, 04:26:43 INFO - 'download_symbols': 'ondemand', 04:26:43 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:26:43 INFO - 'tooltool.py': '/tools/tooltool.py', 04:26:43 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:26:43 INFO - '/tools/misc-python/virtualenv.py')}, 04:26:43 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:26:43 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:26:43 INFO - 'installer_path': 'installer.exe', 04:26:43 INFO - 'log_level': 'info', 04:26:43 INFO - 'log_name': 'talos', 04:26:43 INFO - 'log_to_console': True, 04:26:43 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 04:26:43 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 04:26:43 INFO - 'opt_config_files': (), 04:26:43 INFO - 'pip_index': False, 04:26:43 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 04:26:43 INFO - 'cmd': ('bash', 04:26:43 INFO - '-c', 04:26:43 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 04:26:43 INFO - 'enabled': True, 04:26:43 INFO - 'halt_on_failure': False, 04:26:43 INFO - 'name': 'check_screen_resolution'},), 04:26:43 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 04:26:43 INFO - 'cmd': ('bash', 04:26:43 INFO - '-c', 04:26:43 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 04:26:43 INFO - 'enabled': True, 04:26:43 INFO - 'halt_on_failure': False, 04:26:43 INFO - 'name': 'check_screen_resolution'},), 04:26:43 INFO - 'run_cmd_checks_enabled': True, 04:26:43 INFO - 'sps_profile': False, 04:26:43 INFO - 'sps_profile_interval': 0, 04:26:43 INFO - 'suite': 'dromaeojs-e10s', 04:26:43 INFO - 'system_bits': '32', 04:26:43 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:26:43 INFO - 'title': 't-yosemite-r7-0348', 04:26:43 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:26:43 INFO - 'use_talos_json': True, 04:26:43 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:26:43 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:26:43 INFO - 'work_dir': 'build'} 04:26:43 INFO - [mozharness: 2016-08-14 11:26:43.313173Z] Running clobber step. 04:26:43 INFO - Running pre-action listener: _resource_record_pre_action 04:26:43 INFO - Running main action method: clobber 04:26:43 INFO - rmtree: /builds/slave/test/build 04:26:43 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:26:43 INFO - Running post-action listener: _resource_record_post_action 04:26:43 INFO - [mozharness: 2016-08-14 11:26:43.547654Z] Finished clobber step (success) 04:26:43 INFO - [mozharness: 2016-08-14 11:26:43.547787Z] Running read-buildbot-config step. 04:26:43 INFO - Running pre-action listener: _resource_record_pre_action 04:26:43 INFO - Running main action method: read_buildbot_config 04:26:43 INFO - Using buildbot properties: 04:26:43 INFO - { 04:26:43 INFO - "project": "", 04:26:43 INFO - "product": "firefox", 04:26:43 INFO - "script_repo_revision": "production", 04:26:43 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs-e10s", 04:26:43 INFO - "repository": "", 04:26:43 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs-e10s", 04:26:43 INFO - "buildid": "20160814030203", 04:26:43 INFO - "stage_platform": "macosx64", 04:26:43 INFO - "basedir": "/builds/slave/test", 04:26:43 INFO - "nightly_build": "True", 04:26:43 INFO - "buildnumber": 279, 04:26:43 INFO - "slavename": "t-yosemite-r7-0348", 04:26:43 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 04:26:43 INFO - "platform": "yosemite_r7", 04:26:43 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 04:26:43 INFO - "branch": "mozilla-central", 04:26:43 INFO - "repo_path": "mozilla-central", 04:26:43 INFO - "revision": "6e191a55c3d23e83e6a2e72e4e80c1dc21516493", 04:26:43 INFO - "pgo_build": "False", 04:26:43 INFO - "builduid": "8793c526a9c445938eb1935fff39321d", 04:26:43 INFO - "slavebuilddir": "test" 04:26:43 INFO - } 04:26:43 INFO - Found installer url https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg. 04:26:43 INFO - Running post-action listener: _resource_record_post_action 04:26:43 INFO - [mozharness: 2016-08-14 11:26:43.551247Z] Finished read-buildbot-config step (success) 04:26:43 INFO - [mozharness: 2016-08-14 11:26:43.551360Z] Running download-and-extract step. 04:26:43 INFO - Running pre-action listener: _resource_record_pre_action 04:26:43 INFO - Running main action method: download_and_extract 04:26:43 INFO - mkdir: /builds/slave/test/build/tests 04:26:43 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')]} 04:26:43 INFO - trying https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json 04:26:43 INFO - Downloading https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:26:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:26:44 INFO - Downloaded 1199 bytes. 04:26:44 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 04:26:44 INFO - Using the following test package requirements: 04:26:44 INFO - {u'common': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 04:26:44 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 04:26:44 INFO - u'firefox-51.0a1.en-US.mac.cppunittest.tests.zip'], 04:26:44 INFO - u'gtest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 04:26:44 INFO - u'firefox-51.0a1.en-US.mac.gtest.tests.zip'], 04:26:44 INFO - u'jittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 04:26:44 INFO - u'jsshell-mac.zip'], 04:26:44 INFO - u'mochitest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 04:26:44 INFO - u'firefox-51.0a1.en-US.mac.mochitest.tests.zip'], 04:26:44 INFO - u'mozbase': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 04:26:44 INFO - u'reftest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 04:26:44 INFO - u'firefox-51.0a1.en-US.mac.reftest.tests.zip'], 04:26:44 INFO - u'talos': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 04:26:44 INFO - u'firefox-51.0a1.en-US.mac.talos.tests.zip'], 04:26:44 INFO - u'web-platform': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 04:26:44 INFO - u'firefox-51.0a1.en-US.mac.web-platform.tests.zip'], 04:26:44 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 04:26:44 INFO - u'firefox-51.0a1.en-US.mac.xpcshell.tests.zip']} 04:26:44 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip'] for test suite category: common 04:26: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')]} 04:26:44 INFO - trying https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 04:26:44 INFO - Downloading https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:26:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:26:45 INFO - Downloaded 16330508 bytes. 04:26:45 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 04:26:51 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 04:26:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:26:51 INFO - trying https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 04:26:51 INFO - Downloading https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:26:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:26:52 INFO - Downloaded 16330508 bytes. 04:26:52 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 04:26:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:26:59 INFO - trying https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip 04:26:59 INFO - Downloading https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:26:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:27:01 INFO - Downloaded 14413719 bytes. 04:27:01 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/tests 04:27:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:27:02 INFO - trying https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 04:27:02 INFO - Downloading https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg 04:27:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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 04:27:10 INFO - Downloaded 111177694 bytes. 04:27:10 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 04:27:10 INFO - mkdir: /builds/slave/test/properties 04:27:10 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:27:10 INFO - Writing to file /builds/slave/test/properties/build_url 04:27:10 INFO - Contents: 04:27:10 INFO - build_url:https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 04:27:11 INFO - Running post-action listener: _resource_record_post_action 04:27:11 INFO - Running post-action listener: set_extra_try_arguments 04:27:11 INFO - [mozharness: 2016-08-14 11:27:11.105393Z] Finished download-and-extract step (success) 04:27:11 INFO - [mozharness: 2016-08-14 11:27:11.106196Z] Running populate-webroot step. 04:27:11 INFO - Running pre-action listener: _resource_record_pre_action 04:27:11 INFO - Running main action method: populate_webroot 04:27:11 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:27:11 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:27:11 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:27:11 INFO - '--tppagecycles', 04:27:11 INFO - '7'], 04:27:11 INFO - 'tests': ['tsvgm']}}, 04:27:11 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:27:11 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:27:11 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:27:11 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:27:11 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:27:11 INFO - 'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:27:11 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:27:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:27:11 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:27:11 INFO - 'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['damp', 'tps']}, 04:27:11 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:27:11 INFO - 'tests': ['damp', 'tps']}, 04:27:11 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['dromaeo_dom']}, 04:27:11 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:27:11 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['basic_compositor_video']}, 04:27:11 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 04:27:11 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['a11yr', 04:27:11 INFO - 'ts_paint', 04:27:11 INFO - 'tpaint', 04:27:11 INFO - 'sessionrestore', 04:27:11 INFO - 'sessionrestore_no_auto_restore', 04:27:11 INFO - 'tabpaint']}, 04:27:11 INFO - 'other-e10s': {'tests': ['a11yr', 04:27:11 INFO - 'ts_paint', 04:27:11 INFO - 'tpaint', 04:27:11 INFO - 'sessionrestore', 04:27:11 INFO - 'sessionrestore_no_auto_restore', 04:27:11 INFO - 'tabpaint']}, 04:27:11 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:27:11 INFO - 'ts_paint', 04:27:11 INFO - 'tpaint', 04:27:11 INFO - 'sessionrestore', 04:27:11 INFO - 'sessionrestore_no_auto_restore', 04:27:11 INFO - 'tabpaint']}, 04:27:11 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:27:11 INFO - 'ts_paint', 04:27:11 INFO - 'tpaint', 04:27:11 INFO - 'sessionrestore', 04:27:11 INFO - 'sessionrestore_no_auto_restore', 04:27:11 INFO - 'tabpaint']}, 04:27:11 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['a11yr', 04:27:11 INFO - 'ts_paint', 04:27:11 INFO - 'tpaint', 04:27:11 INFO - 'sessionrestore', 04:27:11 INFO - 'sessionrestore_no_auto_restore', 04:27:11 INFO - 'tabpaint']}, 04:27:11 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['a11yr', 04:27:11 INFO - 'ts_paint', 04:27:11 INFO - 'tpaint', 04:27:11 INFO - 'sessionrestore', 04:27:11 INFO - 'sessionrestore_no_auto_restore', 04:27:11 INFO - 'tabpaint']}, 04:27:11 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['tsvgx', 04:27:11 INFO - 'tsvgr_opacity', 04:27:11 INFO - 'tart', 04:27:11 INFO - 'tscrollx', 04:27:11 INFO - 'cart']}, 04:27:11 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:27:11 INFO - 'tsvgr_opacity', 04:27:11 INFO - 'tart', 04:27:11 INFO - 'tscrollx', 04:27:11 INFO - 'cart']}, 04:27:11 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:27:11 INFO - 'talos_options': ['--disable-e10s'], 04:27:11 INFO - 'tests': ['tp5o']}, 04:27:11 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:27:11 INFO - 'tests': ['tp5o']}, 04:27:11 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:27:11 INFO - 'talos_options': ['--disable-e10s', 04:27:11 INFO - '--xperf_path', 04:27:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:27:11 INFO - 'tests': ['tp5n']}, 04:27:11 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:27:11 INFO - 'talos_options': ['--xperf_path', 04:27:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:27:11 INFO - 'tests': ['tp5n']}}, 04:27:11 INFO - 'talos.zip': {'path': '', 04:27:11 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:27:11 INFO - Running post-action listener: _resource_record_post_action 04:27:11 INFO - [mozharness: 2016-08-14 11:27:11.125181Z] Finished populate-webroot step (success) 04:27:11 INFO - [mozharness: 2016-08-14 11:27:11.125321Z] Running create-virtualenv step. 04:27:11 INFO - Running pre-action listener: _resource_record_pre_action 04:27:11 INFO - Running main action method: create_virtualenv 04:27:11 INFO - Creating virtualenv /builds/slave/test/build/venv 04:27:11 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 04:27:11 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:27:11 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:27:11 INFO - Using real prefix '/tools/python27' 04:27:11 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:27:11 INFO - Installing distribute.............................................................................................................................................................................................done. 04:27:15 INFO - Installing pip.................done. 04:27:15 INFO - Return code: 0 04:27:15 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:27:15 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')]} 04:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:15 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')]} 04:27:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:15 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 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27:15 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 04:27:15 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 04:27:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:15 INFO - 'HOME': '/Users/cltbld', 04:27:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:15 INFO - 'LOGNAME': 'cltbld', 04:27:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:15 INFO - 'MOZ_NO_REMOTE': '1', 04:27:15 INFO - 'NO_EM_RESTART': '1', 04:27:15 INFO - 'PAGER': '/bin/cat', 04:27:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:15 INFO - 'PWD': '/builds/slave/test', 04:27:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:15 INFO - 'SHELL': '/bin/bash', 04:27:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:15 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:15 INFO - 'USER': 'cltbld', 04:27:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:15 INFO - 'XPC_FLAGS': '0x0', 04:27:15 INFO - 'XPC_SERVICE_NAME': '0', 04:27:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:15 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 04:27:15 INFO - Cleaning up... 04:27:15 INFO - Return code: 0 04:27:15 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:27:15 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')]} 04:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:15 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')]} 04:27:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:15 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 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27:15 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 04:27:15 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 04:27:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:15 INFO - 'HOME': '/Users/cltbld', 04:27:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:15 INFO - 'LOGNAME': 'cltbld', 04:27:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:15 INFO - 'MOZ_NO_REMOTE': '1', 04:27:15 INFO - 'NO_EM_RESTART': '1', 04:27:15 INFO - 'PAGER': '/bin/cat', 04:27:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:15 INFO - 'PWD': '/builds/slave/test', 04:27:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:15 INFO - 'SHELL': '/bin/bash', 04:27:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:15 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:15 INFO - 'USER': 'cltbld', 04:27:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:15 INFO - 'XPC_FLAGS': '0x0', 04:27:15 INFO - 'XPC_SERVICE_NAME': '0', 04:27:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:15 INFO - Downloading/unpacking psutil>=3.1.1 04:27:15 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 04:27:15 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 04:27:15 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 04:27:15 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 04:27:15 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 04:27:15 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 04:27:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:27:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:27:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:27:19 INFO - Installing collected packages: psutil 04:27:19 INFO - Running setup.py install for psutil 04:27:19 INFO - building 'psutil._psutil_osx' extension 04:27:19 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 04:27:19 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 04:27:20 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 04:27:20 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 04:27:20 INFO - building 'psutil._psutil_posix' extension 04:27:20 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 04:27:20 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 04:27:20 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 04:27:20 INFO - ^ 04:27:20 INFO - 1 warning generated. 04:27:20 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 04:27:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:27:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:27:20 INFO - Successfully installed psutil 04:27:20 INFO - Cleaning up... 04:27:20 INFO - Return code: 0 04:27:20 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:27: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')]} 04:27:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27: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')]} 04:27:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:20 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 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27:20 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 04:27:20 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 04:27:20 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:20 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:20 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:20 INFO - 'HOME': '/Users/cltbld', 04:27:20 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:20 INFO - 'LOGNAME': 'cltbld', 04:27:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:20 INFO - 'MOZ_NO_REMOTE': '1', 04:27:20 INFO - 'NO_EM_RESTART': '1', 04:27:20 INFO - 'PAGER': '/bin/cat', 04:27:20 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:20 INFO - 'PWD': '/builds/slave/test', 04:27:20 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:20 INFO - 'SHELL': '/bin/bash', 04:27:20 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:20 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:20 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:20 INFO - 'USER': 'cltbld', 04:27:20 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:20 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:20 INFO - 'XPC_FLAGS': '0x0', 04:27:20 INFO - 'XPC_SERVICE_NAME': '0', 04:27:20 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:20 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:27:20 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 04:27:20 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 04:27:20 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 04:27:20 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 04:27:20 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 04:27:20 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 04:27:23 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:27:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:27:23 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:27:23 INFO - Installing collected packages: mozsystemmonitor 04:27:23 INFO - Running setup.py install for mozsystemmonitor 04:27:23 INFO - Successfully installed mozsystemmonitor 04:27:23 INFO - Cleaning up... 04:27:23 INFO - Return code: 0 04:27:23 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:27: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')]} 04:27:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27: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')]} 04:27:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27: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', '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 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 04:27: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 jsonschema==2.5.1 04:27:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:23 INFO - 'HOME': '/Users/cltbld', 04:27:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:23 INFO - 'LOGNAME': 'cltbld', 04:27:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:23 INFO - 'MOZ_NO_REMOTE': '1', 04:27:23 INFO - 'NO_EM_RESTART': '1', 04:27:23 INFO - 'PAGER': '/bin/cat', 04:27:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:23 INFO - 'PWD': '/builds/slave/test', 04:27:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:23 INFO - 'SHELL': '/bin/bash', 04:27:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:23 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:23 INFO - 'USER': 'cltbld', 04:27:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:23 INFO - 'XPC_FLAGS': '0x0', 04:27:23 INFO - 'XPC_SERVICE_NAME': '0', 04:27:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:23 INFO - Downloading/unpacking jsonschema==2.5.1 04:27: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 04:27: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 04:27: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 04:27: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 04:27: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 04:27: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 04:27:26 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:27:26 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:27: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 04:27: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 04:27: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 04:27: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 04:27: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 04:27: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 04:27:26 INFO - Downloading functools32-3.2.3-2.tar.gz 04:27:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:27:26 INFO - warning: no files found matching '*.txt' 04:27:26 INFO - no previously-included directories found matching 'build' 04:27:26 INFO - no previously-included directories found matching 'dist' 04:27:26 INFO - no previously-included directories found matching '.git*' 04:27:26 INFO - Installing collected packages: jsonschema, functools32 04:27:26 INFO - Running setup.py install for functools32 04:27:26 INFO - warning: no files found matching '*.txt' 04:27:26 INFO - no previously-included directories found matching 'build' 04:27:26 INFO - no previously-included directories found matching 'dist' 04:27:26 INFO - no previously-included directories found matching '.git*' 04:27:26 INFO - Successfully installed jsonschema functools32 04:27:26 INFO - Cleaning up... 04:27:26 INFO - Return code: 0 04:27:26 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:27: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')]} 04:27:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27: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')]} 04:27:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27: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', '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 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27: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', 'functools32==3.2.3-2'] in /builds/slave/test/build 04:27: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 functools32==3.2.3-2 04:27:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:26 INFO - 'HOME': '/Users/cltbld', 04:27:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:26 INFO - 'LOGNAME': 'cltbld', 04:27:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:26 INFO - 'MOZ_NO_REMOTE': '1', 04:27:26 INFO - 'NO_EM_RESTART': '1', 04:27:26 INFO - 'PAGER': '/bin/cat', 04:27:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:26 INFO - 'PWD': '/builds/slave/test', 04:27:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:26 INFO - 'SHELL': '/bin/bash', 04:27:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:26 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:26 INFO - 'USER': 'cltbld', 04:27:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:26 INFO - 'XPC_FLAGS': '0x0', 04:27:26 INFO - 'XPC_SERVICE_NAME': '0', 04:27:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:27 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:27:27 INFO - Cleaning up... 04:27:27 INFO - Return code: 0 04:27:27 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:27:27 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')]} 04:27:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:27 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')]} 04:27:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:27 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 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27:27 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 04:27:27 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 04:27:27 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:27 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:27 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:27 INFO - 'HOME': '/Users/cltbld', 04:27:27 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:27 INFO - 'LOGNAME': 'cltbld', 04:27:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:27 INFO - 'MOZ_NO_REMOTE': '1', 04:27:27 INFO - 'NO_EM_RESTART': '1', 04:27:27 INFO - 'PAGER': '/bin/cat', 04:27:27 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:27 INFO - 'PWD': '/builds/slave/test', 04:27:27 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:27 INFO - 'SHELL': '/bin/bash', 04:27:27 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:27 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:27 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:27 INFO - 'USER': 'cltbld', 04:27:27 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:27 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:27 INFO - 'XPC_FLAGS': '0x0', 04:27:27 INFO - 'XPC_SERVICE_NAME': '0', 04:27:27 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:27 INFO - Downloading/unpacking blobuploader==1.2.4 04:27:27 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 04:27:27 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 04:27:27 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 04:27:27 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 04:27:27 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 04:27:27 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 04:27:29 INFO - Downloading blobuploader-1.2.4.tar.gz 04:27:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:27:29 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:27: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 04:27: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 04:27: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 04:27: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 04:27: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 04:27: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 04:27:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:27:30 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:27: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 04:27: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 04:27: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 04:27: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 04:27: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 04:27: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 04:27:31 INFO - Downloading docopt-0.6.1.tar.gz 04:27:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:27:31 INFO - Installing collected packages: blobuploader, requests, docopt 04:27:31 INFO - Running setup.py install for blobuploader 04:27:31 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:27:31 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:27:31 INFO - Running setup.py install for requests 04:27:31 INFO - Running setup.py install for docopt 04:27:31 INFO - Successfully installed blobuploader requests docopt 04:27:31 INFO - Cleaning up... 04:27:32 INFO - Return code: 0 04:27:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:27:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:27:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:27:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:32 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 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27:32 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 04:27:32 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 04:27:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:32 INFO - 'HOME': '/Users/cltbld', 04:27:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:32 INFO - 'LOGNAME': 'cltbld', 04:27:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:32 INFO - 'MOZ_NO_REMOTE': '1', 04:27:32 INFO - 'NO_EM_RESTART': '1', 04:27:32 INFO - 'PAGER': '/bin/cat', 04:27:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:32 INFO - 'PWD': '/builds/slave/test', 04:27:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:32 INFO - 'SHELL': '/bin/bash', 04:27:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:32 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:32 INFO - 'USER': 'cltbld', 04:27:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:32 INFO - 'XPC_FLAGS': '0x0', 04:27:32 INFO - 'XPC_SERVICE_NAME': '0', 04:27:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:27:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-nRfVVS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:27:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:27:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-TsAnf9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:27:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:27:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-ZoLtAm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:27:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:27:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-l4yU5X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:27:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:27:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-_M596a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:27:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:27:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-hYKHHW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:27:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:27:32 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-Q5qSrE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-p8RwWg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-vtTupW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-Whtago-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-s2H4a_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-_o5L2Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-e8JQM0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-vlA9NC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-jdnFO_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-6CusAM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:27:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:27:33 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-n2Hm8t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:27:34 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:27:34 INFO - Running setup.py install for manifestparser 04:27:34 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:27:34 INFO - Running setup.py install for mozcrash 04:27:34 INFO - Running setup.py install for mozdebug 04:27:34 INFO - Running setup.py install for mozdevice 04:27:34 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:27:34 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:27:34 INFO - Running setup.py install for mozfile 04:27:34 INFO - Running setup.py install for mozhttpd 04:27:34 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:27:34 INFO - Running setup.py install for mozinfo 04:27:35 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:27:35 INFO - Running setup.py install for mozInstall 04:27:35 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:27:35 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:27:35 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:27:35 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:27:35 INFO - Running setup.py install for mozleak 04:27:35 INFO - Running setup.py install for mozlog 04:27:35 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:27:35 INFO - Running setup.py install for moznetwork 04:27:35 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:27:35 INFO - Running setup.py install for mozprocess 04:27:35 INFO - Running setup.py install for mozprofile 04:27:36 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:27:36 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:27:36 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:27:36 INFO - Running setup.py install for mozrunner 04:27:36 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:27:36 INFO - Running setup.py install for mozscreenshot 04:27:36 INFO - Running setup.py install for moztest 04:27:36 INFO - Running setup.py install for mozversion 04:27:36 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:27:36 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:27:36 INFO - Cleaning up... 04:27:36 INFO - Return code: 0 04:27:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:27:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:27:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:27:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:27:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:27:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:36 INFO - 'HOME': '/Users/cltbld', 04:27:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:36 INFO - 'LOGNAME': 'cltbld', 04:27:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:36 INFO - 'MOZ_NO_REMOTE': '1', 04:27:36 INFO - 'NO_EM_RESTART': '1', 04:27:36 INFO - 'PAGER': '/bin/cat', 04:27:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:36 INFO - 'PWD': '/builds/slave/test', 04:27:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:36 INFO - 'SHELL': '/bin/bash', 04:27:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:36 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:36 INFO - 'USER': 'cltbld', 04:27:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:36 INFO - 'XPC_FLAGS': '0x0', 04:27:36 INFO - 'XPC_SERVICE_NAME': '0', 04:27:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:27:36 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-8pWZKw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:27:37 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)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-MjBWQu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:27:37 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)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-mdv9RZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:27:37 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)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-cqUevl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:27:37 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)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-pFbsOj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:27:37 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)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-9K_fIW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:27:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-B9Qrlb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:27:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-dVHnaf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:27:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-vC4MaN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:27:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-kQZhO3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:27:37 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)) 04:27:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:27:37 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-aUWo6d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:27:38 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)) 04:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:27:38 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-UgFl9F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:27:38 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)) 04:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:27:38 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-Tty9kM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:27:38 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)) 04:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:27:38 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-921988-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:27:38 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)) 04:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:27:38 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-RbDa5K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:27:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 04:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:27:38 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-VKQ6za-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:27:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 04:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:27:38 INFO - Running setup.py (path:/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/pip-tWK8gJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:27:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 04:27:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:27:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:27:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:27:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:27:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:27:38 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:27:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:27:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:27:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:27:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:27:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:27:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:27:41 INFO - Downloading blessings-1.6.tar.gz 04:27:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:27:41 INFO - Installing collected packages: blessings 04:27:41 INFO - Running setup.py install for blessings 04:27:41 INFO - Successfully installed blessings 04:27:41 INFO - Cleaning up... 04:27:41 INFO - Return code: 0 04:27:41 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:27:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:27:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:27:41 INFO - Reading from file tmpfile_stdout 04:27:41 INFO - Current package versions: 04:27:41 INFO - blessings == 1.6 04:27:41 INFO - blobuploader == 1.2.4 04:27:41 INFO - docopt == 0.6.1 04:27:41 INFO - functools32 == 3.2.3-2 04:27:41 INFO - jsonschema == 2.5.1 04:27:41 INFO - manifestparser == 1.1 04:27:41 INFO - mozInstall == 1.12 04:27:41 INFO - mozcrash == 0.17 04:27:41 INFO - mozdebug == 0.1 04:27:41 INFO - mozdevice == 0.48 04:27:41 INFO - mozfile == 1.2 04:27:41 INFO - mozhttpd == 0.7 04:27:41 INFO - mozinfo == 0.9 04:27:41 INFO - mozleak == 0.1 04:27:41 INFO - mozlog == 3.3 04:27:41 INFO - moznetwork == 0.27 04:27:41 INFO - mozprocess == 0.23 04:27:41 INFO - mozprofile == 0.28 04:27:41 INFO - mozrunner == 6.12 04:27:41 INFO - mozscreenshot == 0.1 04:27:41 INFO - mozsystemmonitor == 0.3 04:27:41 INFO - moztest == 0.7 04:27:41 INFO - mozversion == 1.4 04:27:41 INFO - psutil == 3.1.1 04:27:41 INFO - requests == 1.2.3 04:27:41 INFO - wsgiref == 0.1.2 04:27:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:27:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:27:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:27:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:41 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 04:27:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:27:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:41 INFO - 'HOME': '/Users/cltbld', 04:27:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:41 INFO - 'LOGNAME': 'cltbld', 04:27:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:41 INFO - 'MOZ_NO_REMOTE': '1', 04:27:41 INFO - 'NO_EM_RESTART': '1', 04:27:41 INFO - 'PAGER': '/bin/cat', 04:27:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:41 INFO - 'PWD': '/builds/slave/test', 04:27:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:41 INFO - 'SHELL': '/bin/bash', 04:27:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:41 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:41 INFO - 'USER': 'cltbld', 04:27:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:41 INFO - 'XPC_FLAGS': '0x0', 04:27:41 INFO - 'XPC_SERVICE_NAME': '0', 04:27:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 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)) 04:27:42 INFO - Cleaning up... 04:27:42 INFO - Return code: 0 04:27:42 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:27:42 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')]} 04:27:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:27:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:42 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')]} 04:27:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:27:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:27:42 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 0x10e153a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e1e8618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe32b5b3ba0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, '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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 04:27:42 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 04:27:42 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 04:27:42 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:27:42 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:27:42 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:27:42 INFO - 'HOME': '/Users/cltbld', 04:27:42 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:27:42 INFO - 'LOGNAME': 'cltbld', 04:27:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:27:42 INFO - 'MOZ_NO_REMOTE': '1', 04:27:42 INFO - 'NO_EM_RESTART': '1', 04:27:42 INFO - 'PAGER': '/bin/cat', 04:27:42 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:27:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:27:42 INFO - 'PWD': '/builds/slave/test', 04:27:42 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:27:42 INFO - 'SHELL': '/bin/bash', 04:27:42 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:27:42 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:27:42 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:27:42 INFO - 'USER': 'cltbld', 04:27:42 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:27:42 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:27:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:27:42 INFO - 'XPC_FLAGS': '0x0', 04:27:42 INFO - 'XPC_SERVICE_NAME': '0', 04:27:42 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:27:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:27:42 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:27:42 INFO - Cleaning up... 04:27:42 INFO - Return code: 0 04:27:42 INFO - Running post-action listener: _resource_record_post_action 04:27:42 INFO - Running post-action listener: _start_resource_monitoring 04:27:42 INFO - Starting resource monitoring. 04:27:42 INFO - [mozharness: 2016-08-14 11:27:42.368969Z] Finished create-virtualenv step (success) 04:27:42 INFO - [mozharness: 2016-08-14 11:27:42.369922Z] Running install step. 04:27:42 INFO - Running pre-action listener: _resource_record_pre_action 04:27:42 INFO - Running main action method: install 04:27:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:27:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:27:42 INFO - Reading from file tmpfile_stdout 04:27:42 INFO - Detecting whether we're running mozinstall >=1.0... 04:27:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:27:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:27:42 INFO - Reading from file tmpfile_stdout 04:27:42 INFO - Output received: 04:27:42 INFO - Usage: mozinstall [options] installer 04:27:42 INFO - Options: 04:27:42 INFO - -h, --help show this help message and exit 04:27:42 INFO - -d DEST, --destination=DEST 04:27:42 INFO - Directory to install application into. [default: 04:27:42 INFO - "/builds/slave/test"] 04:27:42 INFO - --app=APP Application being installed. [default: firefox] 04:27:42 INFO - mkdir: /builds/slave/test/build/application 04:27:42 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'] 04:27:42 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 04:28:16 INFO - Reading from file tmpfile_stdout 04:28:16 INFO - Output received: 04:28:16 INFO - /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox 04:28:16 INFO - Running post-action listener: _resource_record_post_action 04:28:16 INFO - [mozharness: 2016-08-14 11:28:16.738599Z] Finished install step (success) 04:28:16 INFO - [mozharness: 2016-08-14 11:28:16.738767Z] Running run-tests step. 04:28:16 INFO - Running pre-action listener: _resource_record_pre_action 04:28:16 INFO - Running main action method: run_tests 04:28:16 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 04:28:16 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 04:28:16 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 04:28:16 INFO - 2016-08-14 04:28:16.753 screenresolution[1692:21608] starting screenresolution argv=screenresolution get 04:28:16 INFO - 2016-08-14 04:28:16.755 screenresolution[1692:21608] Display 0: 1600x1200x32@60 04:28:16 INFO - 2016-08-14 04:28:16.761 screenresolution[1693:21610] starting screenresolution argv=screenresolution list 04:28:16 INFO - Available Modes on Display 0 04:28:16 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 04:28:16 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 04:28:16 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 04:28:16 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 04:28:16 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 04:28:16 INFO - Intel Iris: 04:28:16 INFO - Chipset Model: Intel Iris 04:28:16 INFO - Type: GPU 04:28:16 INFO - Bus: Built-In 04:28:16 INFO - VRAM (Dynamic, Max): 1536 MB 04:28:16 INFO - Vendor: Intel (0x8086) 04:28:16 INFO - Device ID: 0x0a2e 04:28:16 INFO - Revision ID: 0x0009 04:28:16 INFO - Displays: 04:28:16 INFO - Display: 04:28:16 INFO - Resolution: 1600 x 1200 @ 60 Hz 04:28:16 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 04:28:16 INFO - Display Serial Number: 1600x1200 60 04:28:16 INFO - Main Display: Yes 04:28:16 INFO - Mirror: Off 04:28:16 INFO - Online: Yes 04:28:16 INFO - Rotation: Supported 04:28:16 INFO - Return code: 0 04:28:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:28:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:28:17 INFO - Python 2.7.3 04:28:17 INFO - Return code: 0 04:28:17 INFO - grabbing minidump binary from tooltool 04:28:17 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')]} 04:28:17 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 0x10e0b7d30>, '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 0x10de1cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e0afb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:28:17 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 04:28:17 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 04:28:17 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 04:28:17 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:28:17 INFO - Return code: 0 04:28:17 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 04:28:17 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:28:17 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:28:17 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 04:28:17 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:28:17 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/FirefoxNightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0348', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 04:28:17 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/FirefoxNightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0348 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 04:28:17 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ngpxpoJgJ/Render', 04:28:17 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:28:17 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:28:17 INFO - 'HOME': '/Users/cltbld', 04:28:17 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:28:17 INFO - 'LOGNAME': 'cltbld', 04:28:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:28:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 04:28:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:28:17 INFO - 'MOZ_NO_REMOTE': '1', 04:28:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:28:17 INFO - 'NO_EM_RESTART': '1', 04:28:17 INFO - 'PAGER': '/bin/cat', 04:28:17 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:28:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:28:17 INFO - 'PWD': '/builds/slave/test', 04:28:17 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:28:17 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:28:17 INFO - 'SHELL': '/bin/bash', 04:28:17 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.wa9JHVybTI/Listeners', 04:28:17 INFO - 'TMPDIR': '/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/', 04:28:17 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:28:17 INFO - 'USER': 'cltbld', 04:28:17 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:28:17 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:28:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:28:17 INFO - 'XPC_FLAGS': '0x0', 04:28:17 INFO - 'XPC_SERVICE_NAME': '0', 04:28:17 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:28:17 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/FirefoxNightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0348', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 04:28:17 INFO - mozversion application_buildid: 20160814030203 04:28:17 INFO - mozversion application_changeset: 6e191a55c3d23e83e6a2e72e4e80c1dc21516493 04:28:17 INFO - mozversion application_display_name: Nightly 04:28:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:28:17 INFO - mozversion application_name: Firefox 04:28:17 INFO - mozversion application_remotingname: firefox 04:28:17 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:28:17 INFO - mozversion application_vendor: Mozilla 04:28:17 INFO - mozversion application_version: 51.0a1 04:28:17 INFO - mozversion platform_buildid: 20160814030203 04:28:17 INFO - mozversion platform_changeset: 6e191a55c3d23e83e6a2e72e4e80c1dc21516493 04:28:17 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:28:17 INFO - mozversion platform_version: 51.0a1 04:28:17 INFO - using testdate: 1471174097 04:28:17 INFO - actual date: 1471174097 04:28:17 INFO - starting webserver on 'localhost:49272' 04:28:17 INFO - SUITE-START | Running 2 tests 04:28:17 INFO - TEST-START | dromaeo_css 04:28:17 INFO - operating with platform_type : mac_ 04:28:17 INFO - Initialising browser for dromaeo_css test... 04:28:17 INFO - TEST-INFO | started process 1703 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/tmpvq_o3d/profile http://localhost:49272/getInfo.html) 04:28:20 INFO - PROCESS | 1703 | __metrics Screen width/height:1600/1200 04:28:20 INFO - PROCESS | 1703 | colorDepth:24 04:28:20 INFO - PROCESS | 1703 | Browser inner width/height: 1024/689 04:28:20 INFO - PROCESS | 1703 | __metrics 04:28:20 ERROR - PROCESS | 1703 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 04:28:20 INFO - TEST-INFO | 1703: exit 0 04:28:20 INFO - Browser initialized. 04:28:20 INFO - Running cycle 1/1 for dromaeo_css test... 04:28:20 INFO - TEST-INFO | started process 1708 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/tmpvq_o3d/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:28:32 INFO - PROCESS | 1708 | RSS: Main: 239796224 04:28:32 INFO - PROCESS | 1708 | 04:29:22 INFO - PROCESS | 1708 | 1471174162566 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] 04:31:33 INFO - PROCESS | 1708 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49272/tests/dromaeo/cssquery-ext.html) 04:31:35 INFO - PROCESS | 1708 | RSS: Main: 254500864 04:31:35 INFO - PROCESS | 1708 | 04:34:38 INFO - PROCESS | 1708 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-ext.html (next: http://localhost:49272/tests/dromaeo/cssquery-jquery.html) 04:34:38 INFO - PROCESS | 1708 | RSS: Main: 266592256 04:34:38 INFO - PROCESS | 1708 | 04:37:40 INFO - PROCESS | 1708 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49272/tests/dromaeo/cssquery-mootools.html) 04:37:41 INFO - PROCESS | 1708 | RSS: Main: 271331328 04:37:41 INFO - PROCESS | 1708 | 04:40:43 INFO - PROCESS | 1708 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49272/tests/dromaeo/cssquery-prototype.html) 04:40:43 INFO - PROCESS | 1708 | RSS: Main: 270827520 04:40:43 INFO - PROCESS | 1708 | 04:43:46 INFO - PROCESS | 1708 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49272/tests/dromaeo/cssquery-yui.html) 04:43:47 INFO - PROCESS | 1708 | RSS: Main: 276385792 04:43:47 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-yui.html (next: http://localhost:49272/tests/dromaeo/cssquery-dojo.html) 04:46:50 INFO - PROCESS | 1708 | RSS: Main: 279621632 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | __start_tp_report 04:46:50 INFO - PROCESS | 1708 | _x_x_mozilla_page_load 04:46:50 INFO - PROCESS | 1708 | _x_x_mozilla_page_load_details 04:46:50 INFO - PROCESS | 1708 | |i|pagename|runs| 04:46:50 INFO - PROCESS | 1708 | |0;dojo.html;3400.387930172569;3406.812625305609;3428.8971330860077;3430.6740859618326;3465.2549701814105;5583.637063590863;5778.422157784219;5832.416758324171;5833.358330583643;5843.503302219311;4331.891702707434;5819.418058194178;5829.125631155329;5840.386759390267;5896.941030589693;5253.44838791928;5302.469753024705;5323.893522129574;5346.27825243591;5394.406615272317;4399.450068741407;5205.557527610158;5231.26762253283;5301.655392399501;5330.653507522018;5255.343082114755;5281.234221037928;5288.338957630296;5307.601929855257;5309.548688361494;5260.473952604747;5272.947270527322;5313.38896026958;5322.627416080876;5364.034473794715;5150.61370397218;5190.506901844319;5271.077561426735;5299.4435584263865;5304.575633949314;5778.219940308047;5818.41815818419;5838.2118414013985;5839.065749480105;5895.086261629454;6210.285817131043;6276.184096067527;6291.968540157316;6302.306746257908;6302.4958003359625;6211.81364559064;6218.253809542839;6225.501959843202;6251.562390632657;6266.655333956631;4933.703977761345;5899.67551784656;5954;5965.373635768268;6024.09638554216;6230.937690623035;6297.653629050446;6301.590396624205;6318.684065796691;6330.272018717907;5242.370915490165;6125.20492926512;6186;6237.438630523275;6246.312905580383;5844.766209351578;5986.610870293504;6233.844153896189;6255.611196456676;6315.936840631535;5208.557272631793;6229.813105606839;6271.62370257786;6275.905861412082;6284.057391391328;6165.722542485599;6169.629822210682;6227.844303892349;6250.124982502453;6321.146645202839;4999.700017998932;5007.549320561094;5016.949830501649;5019.874503137451;5020.171671674206;4509.549045095464;4518.683692141519;4525.208088584484;4530.161920044802;4557.316402539645;5862.14998825168;5879.412058794086;5985.371535988658;6023.096535519707;6034.728437220336;5157.742112894341;6253.6560489173535;6290.685465726695;6296.181496405529;6403.551751377452;5985.670788106609;5995.970020149958;5997.55018373615;6011.729472173763;6030.517558595302;5456.563474921997;5457.345118585795;5467.863303417446;5506.91739623906;5512.751926163332;5340.759665815125;6335.619862808247;6338.366163383625;6372.681365931685;6382.393672601095;6222.439980401786;6232.065190221322;6270.435660790551;6275.874482510416;6281.057841323838;6232.407921247474;6300.495960323072;6302.684865756785;6356.2054743157105;6363.268224154282;5307.01820163271;6246.593971391845;6278.466330361788;6291.937080629318;6294.874102518015;5615.719214039364;6262.405071518198;6275.184226050585;6290.150829637941;6291.937080629135;6138.478229350377;6142.590862071594;6175.042868355412;6187.81436556904;6231.470325022243;4698.248280275139;6218.81343559694;6220.471259942956;6235.095911092957;6241.937580624136;5012.172991456515;5590.301212348457;5961.821145365646;6136.846578835565;6139.508839292756;6143.354947730602;6153.077038444269;6170.413810687977;6178.721957511832;6246.437820596168;6101.786437474844;6131.713108457195;6150.477209437248;6159.23009623797;6160.661163636043 04:46:50 INFO - PROCESS | 1708 | |1;ext.html;507.5989967925339;520.9739513024348;527.4751622135975;532.5819231902957;548.3091304955755;39342.409863852066;41483.37774933375;41643.37534936978;41888.79055604725;41927.3710894336;42680;43185.13629727404;43397.56602433975;43456.782716086374;43480.13039739204;9691.418514889094;9904.405735655848;9915.058069483424;9922.057404546556;9937.453440060794;9734.221262299;9831.90168098317;9859;9871.407715537054;9886.752831179243;9849.704508864745;9875.851862222073;9903.306768526207;9909.256805739562;9924.305298629099;9826.754331141707;9843.212542996544;9861.506924653739;9864.60541578336;9868.161206297473;9669.70990870275;9748;9749.658761943369;9755.02449755026;9760.658376956844;39843.40234896479;40747.796261018506;40771.1845763086;41031;41093.38359924604;3358.932821343584;3430.047575827089;3851.5763266040713;3853.325668008087;4105.220008198433;22918.083276668913;30952;31162.688373116205;31322.06033818989;32571;3214.4214041472524;3264;3387.61042480113;3418.384690755663;3442.9311413771584;486003;488118;513115;514834;514872;61302.69348653317;61561.76876462446;61581.692091539255;61612.69193654093;62856.685716571126;64030.67984660047;64120.35879641144;64269.678651606446;64747.35252647507;64831.67584162049;16510.257038433298;16621.66756664884;16624;16734.330626775038;16746.246418910934;12802.743945121045;12909.54816581415;12931.030172737082;12931.741365172644;12969.221846689228;16855;17604.71138751954;17699.469015929542;17700.645987080185;17718.291268349378;6065.878682426415;6368.044793280952;6648.83377915556;6683.198016237985;6725.562838415487;885.5395194498825;960.9135177834029;970.8106919150839;982.3663736889808;990.9851352229722;33163.17092072718;33568.832155839555;34316.48525272123;34701.47947780785;34858.65141348554;987.1313244344931;1114.660028691257;1154.157465050501;1166.3410173252084;1186.5846953566356;15133.621659458602;15750.606234843992;15759.921200393925;15765.605859853365;16185.352585896668;684796;693981;700406.4817083244;705773;705814;59210.703946480855;60042.69978650079;60471.39528604745;60497.69751151216;60548.39451605516;1355.1801160297878;1433.6702558411623;1460.7808828675784;1464.3044553836842;1464.4142343062647;27197.320066998484;30872.53691194589;31868;32143;32954.83522582372;53118;53852.730736346064;53908;53966.98429204335;54042;580564;583206;586791;586807;590252;43629.56370436255;44580;45331;45489.77255113703;45536.31695524636;49172;49890;50170.24744628907;50572.98854022972;50731.49268507268;40879.795601021804;41025.384619231336;41086.794566026976;41234.175316494104;42122.94692632709;40209.99475013148;40963.7951810239;41056.58943410647;41228.969275767144;41913.58086419097;33180.83409582936;38146.809265953496;39463.81608551748;40124.598754012084;40130.39804402995;35450;35705.82147089352;36004.09989750277;36463.63536364709;36940.63059369372;25777.355566110247;26058.087966921066;26220.475590488466;26545.203643890713;26845.865770671022 04:46:50 INFO - PROCESS | 1708 | |2;jquery.html;350.66686647684696;371.1630273732734;379.3418419042961;381.34789509938;400.23155541360586;20281.290154844584;20327.49181270469;21943;21943;22090.11639534421;12022;12191.817122743167;15268.778497720183;19772.50568735782;20317.593648127066;4585.495595484511;5136.486351364871;5296.834696366793;5523.392426833045;6010.669413182273;4237.258479766044;5456.61803673743;5505.559555235592;5506.972465137669;5510.448955104497;5373.489518495756;5378.542823859957;5499.917501237484;5501.064818980783;5506.421825708303;5163.328767260251;5892.440218179266;6006.099085137221;6017.608855424383;6019.157317975443;5141;5290.867728306785;5304.416514183436;5312.415634280226;5368.248445217672;13419;13519.86480135196;17729.113544322732;25281.494370112494;25632.615510767355;2186.7047948527065;2453.8773061347038;2477.962830557543;2932.398858234057;3007.1429642551766;9424.387414818084;9726.90273097267;9744.07431294026;9957.302988790787;10233.48832558369;1839.8988055656935;1851.518605162654;1860.674381983161;1879.0886420086247;1882.585831117152;88087.55956220243;109632.4518377403;112504.43747781208;114286;114299.42850285779;11344.943275283737;11443.427828608535;11560.30638161713;11583.07335413165;11735;14313.28433578317;14493.637659058608;14507.347169377403;14525.201113938623;14529.709405812036;7982;8426.4944103354;8574;8605.354598405145;8745.169208925143;7758.013164931542;8296.543690097102;8497.362697797565;8529.872051919227;8736.825263494695;3452.8618855246013;4296.668032909808;4488.685791994594;4496.437945256843;4594;1847.6918728335675;1917.769867615867;1934.5453818352676;1950.5611237471455;1993.3421970749619;849.4096602861076;888.6891834543995;897.2866571076011;900.2078171209293;924.6994726713845;17391.130443477774;20187.293444729363;20633.89683051575;20685.793142068687;20687.17251309961;936.1434287626745;959.5490119643756;970.9320347575743;993.7764003099389;1030.7989941961396;10127.64553240633;10535.157187424988;10601.946990265154;10632.734181645521;10653.520591573399;604733;605459;612563;621816;633686;94405;129988;132684;140079.5992040087;147261;977.9706608801605;1000.2098342309494;1003.7440452684665;1016.3038318751679;1017.2828156149897;14913.552593422215;17137.88603740753;18817.6236475267;19472.61054778868;20068.698969515175;45151.77424112859;54531.454685452634;56551.15173272322;56657.15014274872;57715.1342729851;79151.4169716591;80313.79529306949;80553.19446805457;80970;83750;7984.24149705777;8066.878996814935;8253.463524870864;8259.793505162419;8393.790155246168;11853.822192666945;12503.312317822607;12534.247945123321;12899.742005160031;13446.596602101952;10796.244262901522;10974.890251097388;11175.441227938732;11368.602098926498;11382.715432114263;10861.837072443761;10933.125349972142;11240.156988225752;11260.98651121403;11441.42792860337;10911;11347.886521134684;11533;11696.005839503738;11751.88248117542;8035.196480351918;8212.46618969765;8221.383396245425;8260.545669987969;8484.660613575388;8390.496570205807;11181;11426.25729327591;11635.76728465409;11775 04:46:50 INFO - PROCESS | 1708 | |3;mootools.html;1528.7095451864147;1554.5569512688883;1751.9926042525542;1808.8372046515829;1811.1940186616944;7921.643526041327;8440.831183376336;8787.12128787121;9021.413608115476;9046.819063618723;8733.083026282244;8911.73264802057;8927.821443571125;8936.508492032935;8938.86591701125;2343.543009113228;2389.4026493376655;2390.5537150024247;2391.760823917603;2400.31590996566;2362.3621622162004;2373.857568545884;2406.181898154627;2410.4693519615084;2414.4929564791414;1890.8770929889513;2260.378395941121;2290.6678531612906;2302.9884850575722;2303.366574192094;2349.9882500587387;2359.528094381131;2369.3247424484025;2375.4180225844607;2375.667406563074;2353.317537914003;2370.2415227127326;2371.9407014824596;2375.4655202579456;2377.8573285602747;8810.339224558184;8934.821303573957;8973.685920992733;8974.596143173572;8982.281417486585;5285.07511185541;5302.814401495929;5335.279737235501;5383.838484845461;5401.43284955078;3539.7168226541817;3666.724995625312;3668.6881615062753;3732.850685972558;3739.607341229159;1075.2097208551709;1107.5901916290943;1108.3405373802575;1114.0975809594254;1128.6783266769014;11441.885581144164;11564.76870462586;11573.594924177612;11596.826047609293;11634.883651163549;4557.339185818038;4680.7191568506;4837.879053023703;4870.293807397908;4883.682560633548;8942.776430589287;8943.731688049369;9877.703668889944;9925.900740992642;9939.254555908336;5334.333208348957;5366.517013468807;5373.435789242073;5373.677579345173;5375.381831089397;4479.17135329965;4821.397325334333;4918.926216106761;4936.407631084293;4972.030454061423;3417.2652879631;3891.922161556753;3969.126792105732;4023.8994025149605;4091.8158682859344;1293.6765808547864;1297.2151848131932;1299.8635143310005;1301.7721898667696;1318.406716977364;903.4850135422878;937.7280588629358;938.7561481037652;948.8956214816365;971.9951400242953;4642.489326174118;5414.269073675082;5980.910286345621;6095.652562707711;6192.318844927055;437.372370648121;440.8324836562086;447.73136118328745;451.38160719814067;454.75670516274295;3994.4407782910416;4005.439238506611;4087.550369459357;4116.794160291974;4123.2165888481095;9891.950540247253;10884;10949.397783122005;10967.83548246777;10972;10903.073238774634;10917.836232456519;10940.507677154546;10954.561817527368;10970.506327215295;7837.529748215125;8264.462809917337;8270.793230169174;8312.501249924902;8370.581470926429;5918.556108291809;5990.670513121646;6026.168744655896;6139.1098290746695;6274.749010039547;9968.950155249177;10170.440625765654;10184.592616295266;10211.948940255252;10213.693589192337;9543;9809.068138526829;9871.605135794487;9967.252456065678;9978;6947.652617369213;7350.301721336678;7472.663730132266;7544.66049027806;7639.541627502367;8444.535550544779;8528.914710852812;8553.786155346166;8561.657533698582;8588;7510.286522780327;7540.514161997222;7597.278258565428;7714.614269286625;7781.883271750815;7412.407007439284;7479.289467500579;7507.699692012258;7562.962185189039;7679.539227646359;6834.760783372558;6928.896066559107;6947.861042779015;6966.059581956371;6988.266232045562;4541.818327267005;4828.66199366041;4955.132851751001;5055.898882022412;5145.842185508231;4954.108260513142;4986.376702912136;5027.74861256943;5083.364579427572;5207.609429292894 04:46:50 INFO - PROCESS | 1708 | |4;prototype.html;311.4502902377304;315.8704930978298;318.3553304558269;322.969317914798;324.4613940858173;5330.374235858062;5769.653820770756;5846.678432686201;5855.765769369225;5869.7652093916295;5177.508136727014;5452.609584555933;5734.340550836655;5740.7129643517765;5806.4483874032;4082.9792551862033;4184.832606695729;4256.914861702764;4309.245881970658;4327.394164816928;3870.9225815483674;4036.374361973884;4280.486341639008;4292.5278219396;4344.45694288214;3706.962930370689;4269.6370808481315;4311.611954924057;4343.609075183249;4354.782260886959;3960.485136932209;4086.9795651021705;4247.384129301234;4258.339957306592;4335.9187589957;3686.4470329450796;3710.591834898159;3726.5341832270965;3742.981285093584;3745.2883952049297;4523.660725445572;4635.907281854378;5186;5607.327120745495;5612.242347283105;4348.043430445297;4566.70316429431;4843.975780121112;4885;4896.608271338285;4873.926891096601;5088.804131029206;5213.921791173136;5844.4739973402175;5967.761289548413;3509.842057107436;3517.2262102337445;4044.716869819114;4090.5704900985265;4122.2579935611575;5066.505380912639;6103.72533236001;6227.813165605039;6283.392392157295;6325.627889541422;4152.854650087233;4163.044238590574;4174.246816337085;4181.6236538711055;4181.916361672749;3781.3193625147737;4251.128518653669;4254.404383386328;4260.744355338689;4288.335308027261;3778.6306797078123;4984.252362145635;5010.323606313174;5012.914474703105;5033.219850923113;5950.345461999176;5985.7904973326595;5995.2206213192;6077.24034495688;6139.539534534928;1163.7323415614455;1354.607163922471;1453.5203382883624;1458.9781153282709;1462.817147856518;866.9380009488326;867.9349048821364;897.8294124116397;920.963161473547;969.4280374579032;4860.295257187759;5446.782128714886;5536.501714845684;5594.636348637326;5631.057285236587;5680.857978550486;6122.479589234876;6125.693715314216;6142.754289828446;6165.260168779775;4650.790714417859;5134.794608215704;5322.627416080914;5414.83755487336;5627.803026894039;2692.649955505811;2837.7020412856764;3210.3739770744946;3248.514886112126;3252.821094839759;5296.814611488579;5541.972290138604;5887.4406931341455;6379.776707815204;6447;5016.398032236082;5623.297087864017;6301.794371969774;6327.430531252209;6330.39861213184;5847.526642118783;6357.327364387172;6384.968075159594;6385.13800636908;6450.935490645127;5405.243265942692;5809.651420914759;5961.254843144607;6058.7273572688455;6108.969455152695;5648.046367542819;6073.574849760651;6089.1779609753885;6096.177016102947;6121.204243448323;5954.940450595439;6210.968945155245;6287.962486189727;6306.707125039265;6360.650164241011;4117.835286588503;4132.772697501667;4133.256013917524;4134.297169481256;4150.460440142762;5371.462853714597;5504.724763761716;5751.022326204639;6117.388261173847;6145.877082458415;4861.562459378673;5600.747966341606;5951.577842740355;5961.333779725524;5984.551158663031;4967.726775027409;5377.650452720561;5767.653940763567;6064.090386441892;6108.419700128481;4349.652027837702;5936.476997276054;6000;6002.639841609517;6037.347404820196;5992.101184822312;5992.580519363602;6017.2779266488305;6046.3046749624355;6090.573659843769;5937.881242375042;5956.731947062306;5976.731047102804;5985.940140598538;5999.590301128755 04:46:50 INFO - PROCESS | 1708 | |5;yui.html;646.7348387161263;711.89677496763;719.2124623537227;791.3510921044739;810.975670729878;15361.385544578217;16141.09460297149;16148.354065837353;16185.75721364179;16193.433229836957;14561.708765824676;14589.781153282709;14709.043912145704;14711.852881471183;14714.558563243094;674.349252970883;807.7617102954642;816.2286639126029;817.914119017502;843.6836186430089;831.7296878514477;844.7085755414372;845.9577021148949;847.8601030829906;848.2832006954114;875.9211670949613;883.9116088391141;890.7951171230621;893.7363477774039;895.234574438852;872.9956350218208;885.154677283193;885.579349808842;889.6308032166643;891.095538028898;645.4739387399302;648.6367634124905;654.9913133773982;655.2104713819836;659.0575477067791;14957.850421495754;14962.70074598502;14963.728083112948;14994.400223991028;15006.699866002618;14677.55967320982;14726.263686815617;14781.187034713086;14803.259837008214;14808.629784255372;11882.58410955621;11979.161458697807;12009;12048.277103373826;12266.338791259264;3851.5378154621626;3924.7056470764524;3937.5078115235597;4017.5580686124504;4094.2220978014084;121266.04652556185;124760;126443.36778316142;128164;129550;11093.944530277297;11280.097592192606;11309.71725706864;11452;11667.708307292216;22874.542509149724;23134.53730925372;23137.652935205984;23147;23165;8299.958500207582;8376.612665390334;8424.4945303282;8455.619497122521;8590.441621294722;3943.842246310173;4505.301678239878;4638.675292729544;4644.0944015916575;4708.364370809965;3012.9397412052076;3615.5661320641166;3645.2345007548183;3658.396364599811;3692.3538380783257;563.6420872745836;573.9110437882135;651.8956966885371;661.9338066193438;665.6738198282903;576.6132451454259;597.0536699331522;602.9005214139705;656.4551422319558;679.3037136934582;9279.76800579991;9467.76330591727;9745.125944208381;9864.408135511892;9944.900550994542;531.1899353485965;620.2649859916014;663.4924282923567;666.120720648739;669.7053296549502;4493.303537951622;4751.809927602926;4753.808182294161;4791.924390123227;4801.447833499123;129708.70291297155;133465;149517;151184;178654;115001.42499287617;117942;129544;130303.69696303105;133806;72920.54158916791;73895.26104738991;78485;97883.40215358917;104812;7435.997167619087;8181.713640022571;8764.868526972228;8909.331800114887;8917.152870477294;46297.53702463067;50634;57081.57296067465;57285.42714572801;60789.392106080144;61573;85549.57225213834;88980.5550972241;89016.5549172276;90691.21014268103;11352.829707554229;11607.883921161017;11664.008559272557;11680.649580512598;11785.705357366134;12451.564195253122;12735.363231838557;12797.29614871191;12988;13117.147385419918;11854.170208085352;11896.821547676618;11898.76202475963;12014.279143251433;12345.382730863601;11799.941000294944;11986.400679966142;11990.580329688419;12371.257724536557;12478.313692746986;9565.426074435556;9753.463559504295;11844.28934263947;11871.643850684493;12262.570810021607;10094.444805535471;10117.19062475015;10234.53944572511;10314.381137131797;10367.222458315506;9360.660143535388;10268.024537668909;10373.896261037293;10485.423301718478;10498.160147188053 04:46:50 INFO - PROCESS | 1708 | __end_tp_report 04:46:50 INFO - PROCESS | 1708 | __start_cc_report 04:46:50 INFO - PROCESS | 1708 | _x_x_mozilla_cycle_collect,404 04:46:50 INFO - PROCESS | 1708 | __end_cc_report 04:46:50 INFO - PROCESS | 1708 | __startTimestamp1471175210266__endTimestamp 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | ------- Summary: start ------- 04:46:50 INFO - PROCESS | 1708 | Number of tests: 6 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | [#0] dojo.html Cycles:165 Average:5757.97 Median:6011.73 stddev:657.03 (10.9%) stddev-sans-first:632.48 04:46:50 INFO - PROCESS | 1708 | Values: 3400.4 3406.8 3428.9 3430.7 3465.3 5583.6 5778.4 5832.4 5833.4 5843.5 4331.9 5819.4 5829.1 5840.4 5896.9 5253.4 5302.5 5323.9 5346.3 5394.4 4399.5 5205.6 5231.3 5301.7 5330.7 5255.3 5281.2 5288.3 5307.6 5309.5 5260.5 5272.9 5313.4 5322.6 5364.0 5150.6 5190.5 5271.1 5299.4 5304.6 5778.2 5818.4 5838.2 5839.1 5895.1 6210.3 6276.2 6292.0 6302.3 6302.5 6211.8 6218.3 6225.5 6251.6 6266.7 4933.7 5899.7 5954.0 5965.4 6024.1 6230.9 6297.7 6301.6 6318.7 6330.3 5242.4 6125.2 6186.0 6237.4 6246.3 5844.8 5986.6 6233.8 6255.6 6315.9 5208.6 6229.8 6271.6 6275.9 6284.1 6165.7 6169.6 6227.8 6250.1 6321.1 4999.7 5007.5 5016.9 5019.9 5020.2 4509.5 4518.7 4525.2 4530.2 4557.3 5862.1 5879.4 5985.4 6023.1 6034.7 5157.7 6253.7 6290.7 6296.2 6403.6 5985.7 5996.0 5997.6 6011.7 6030.5 5456.6 5457.3 5467.9 5506.9 5512.8 5340.8 6335.6 6338.4 6372.7 6382.4 6222.4 6232.1 6270.4 6275.9 6281.1 6232.4 6300.5 6302.7 6356.2 6363.3 5307.0 6246.6 6278.5 6291.9 6294.9 5615.7 6262.4 6275.2 6290.2 6291.9 6138.5 6142.6 6175.0 6187.8 6231.5 4698.2 6218.8 6220.5 6235.1 6241.9 5012.2 5590.3 5961.8 6136.8 6139.5 6143.4 6153.1 6170.4 6178.7 6246.4 6101.8 6131.7 6150.5 6159.2 6160.7 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | [#1] ext.html Cycles:180 Average:73746.01 Median:43291.35 stddev:160637.36 (371.1%) stddev-sans-first:160993.87 04:46:50 INFO - PROCESS | 1708 | Values: 507.6 521.0 527.5 532.6 548.3 39342.4 41483.4 41643.4 41888.8 41927.4 42680.0 43185.1 43397.6 43456.8 43480.1 9691.4 9904.4 9915.1 9922.1 9937.5 9734.2 9831.9 9859.0 9871.4 9886.8 9849.7 9875.9 9903.3 9909.3 9924.3 9826.8 9843.2 9861.5 9864.6 9868.2 9669.7 9748.0 9749.7 9755.0 9760.7 39843.4 40747.8 40771.2 41031.0 41093.4 3358.9 3430.0 3851.6 3853.3 4105.2 22918.1 30952.0 31162.7 31322.1 32571.0 3214.4 3264.0 3387.6 3418.4 3442.9 486003.0 488118.0 513115.0 514834.0 514872.0 61302.7 61561.8 61581.7 61612.7 62856.7 64030.7 64120.4 64269.7 64747.4 64831.7 16510.3 16621.7 16624.0 16734.3 16746.2 12802.7 12909.5 12931.0 12931.7 12969.2 16855.0 17604.7 17699.5 17700.6 17718.3 6065.9 6368.0 6648.8 6683.2 6725.6 885.5 960.9 970.8 982.4 991.0 33163.2 33568.8 34316.5 34701.5 34858.7 987.1 1114.7 1154.2 1166.3 1186.6 15133.6 15750.6 15759.9 15765.6 16185.4 684796.0 693981.0 700406.5 705773.0 705814.0 59210.7 60042.7 60471.4 60497.7 60548.4 1355.2 1433.7 1460.8 1464.3 1464.4 27197.3 30872.5 31868.0 32143.0 32954.8 53118.0 53852.7 53908.0 53967.0 54042.0 580564.0 583206.0 586791.0 586807.0 590252.0 43629.6 44580.0 45331.0 45489.8 45536.3 49172.0 49890.0 50170.2 50573.0 50731.5 40879.8 41025.4 41086.8 41234.2 42122.9 40210.0 40963.8 41056.6 41229.0 41913.6 33180.8 38146.8 39463.8 40124.6 40130.4 35450.0 35705.8 36004.1 36463.6 36940.6 25777.4 26058.1 26220.5 26545.2 26845.9 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | [#2] jquery.html Cycles:180 Average:34989.01 Median:14282.51 stddev:102585.21 (718.3%) stddev-sans-first:102840.02 04:46:50 INFO - PROCESS | 1708 | Values: 350.7 371.2 379.3 381.3 400.2 20281.3 20327.5 21943.0 21943.0 22090.1 12022.0 12191.8 15268.8 19772.5 20317.6 4585.5 5136.5 5296.8 5523.4 6010.7 4237.3 5456.6 5505.6 5507.0 5510.4 5373.5 5378.5 5499.9 5501.1 5506.4 5163.3 5892.4 6006.1 6017.6 6019.2 5141.0 5290.9 5304.4 5312.4 5368.2 13419.0 13519.9 17729.1 25281.5 25632.6 2186.7 2453.9 2478.0 2932.4 3007.1 9424.4 9726.9 9744.1 9957.3 10233.5 1839.9 1851.5 1860.7 1879.1 1882.6 88087.6 109632.5 112504.4 114286.0 114299.4 11344.9 11443.4 11560.3 11583.1 11735.0 14313.3 14493.6 14507.3 14525.2 14529.7 7982.0 8426.5 8574.0 8605.4 8745.2 7758.0 8296.5 8497.4 8529.9 8736.8 3452.9 4296.7 4488.7 4496.4 4594.0 1847.7 1917.8 1934.5 1950.6 1993.3 849.4 888.7 897.3 900.2 924.7 17391.1 20187.3 20633.9 20685.8 20687.2 936.1 959.5 970.9 993.8 1030.8 10127.6 10535.2 10601.9 10632.7 10653.5 604733.0 605459.0 612563.0 621816.0 633686.0 94405.0 129988.0 132684.0 140079.6 147261.0 978.0 1000.2 1003.7 1016.3 1017.3 14913.6 17137.9 18817.6 19472.6 20068.7 45151.8 54531.5 56551.2 56657.2 57715.1 79151.4 80313.8 80553.2 80970.0 83750.0 7984.2 8066.9 8253.5 8259.8 8393.8 11853.8 12503.3 12534.2 12899.7 13446.6 10796.2 10974.9 11175.4 11368.6 11382.7 10861.8 10933.1 11240.2 11261.0 11441.4 10911.0 11347.9 11533.0 11696.0 11751.9 8035.2 8212.5 8221.4 8260.5 8484.7 8390.5 11181.0 11426.3 11635.8 11775.0 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | [#3] mootools.html Cycles:180 Average:5729.20 Median:4954.62 stddev:3220.47 (65.0%) stddev-sans-first:3214.04 04:46:50 INFO - PROCESS | 1708 | Values: 1528.7 1554.6 1752.0 1808.8 1811.2 7921.6 8440.8 8787.1 9021.4 9046.8 8733.1 8911.7 8927.8 8936.5 8938.9 2343.5 2389.4 2390.6 2391.8 2400.3 2362.4 2373.9 2406.2 2410.5 2414.5 1890.9 2260.4 2290.7 2303.0 2303.4 2350.0 2359.5 2369.3 2375.4 2375.7 2353.3 2370.2 2371.9 2375.5 2377.9 8810.3 8934.8 8973.7 8974.6 8982.3 5285.1 5302.8 5335.3 5383.8 5401.4 3539.7 3666.7 3668.7 3732.9 3739.6 1075.2 1107.6 1108.3 1114.1 1128.7 11441.9 11564.8 11573.6 11596.8 11634.9 4557.3 4680.7 4837.9 4870.3 4883.7 8942.8 8943.7 9877.7 9925.9 9939.3 5334.3 5366.5 5373.4 5373.7 5375.4 4479.2 4821.4 4918.9 4936.4 4972.0 3417.3 3891.9 3969.1 4023.9 4091.8 1293.7 1297.2 1299.9 1301.8 1318.4 903.5 937.7 938.8 948.9 972.0 4642.5 5414.3 5980.9 6095.7 6192.3 437.4 440.8 447.7 451.4 454.8 3994.4 4005.4 4087.6 4116.8 4123.2 9892.0 10884.0 10949.4 10967.8 10972.0 10903.1 10917.8 10940.5 10954.6 10970.5 7837.5 8264.5 8270.8 8312.5 8370.6 5918.6 5990.7 6026.2 6139.1 6274.7 9969.0 10170.4 10184.6 10211.9 10213.7 9543.0 9809.1 9871.6 9967.3 9978.0 6947.7 7350.3 7472.7 7544.7 7639.5 8444.5 8528.9 8553.8 8561.7 8588.0 7510.3 7540.5 7597.3 7714.6 7781.9 7412.4 7479.3 7507.7 7563.0 7679.5 6834.8 6928.9 6947.9 6966.1 6988.3 4541.8 4828.7 4955.1 5055.9 5145.8 4954.1 4986.4 5027.7 5083.4 5207.6 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | [#4] prototype.html Cycles:180 Average:4818.93 Median:5410.04 stddev:1497.72 (27.7%) stddev-sans-first:1463.21 04:46:50 INFO - PROCESS | 1708 | Values: 311.5 315.9 318.4 323.0 324.5 5330.4 5769.7 5846.7 5855.8 5869.8 5177.5 5452.6 5734.3 5740.7 5806.4 4083.0 4184.8 4256.9 4309.2 4327.4 3870.9 4036.4 4280.5 4292.5 4344.5 3707.0 4269.6 4311.6 4343.6 4354.8 3960.5 4087.0 4247.4 4258.3 4335.9 3686.4 3710.6 3726.5 3743.0 3745.3 4523.7 4635.9 5186.0 5607.3 5612.2 4348.0 4566.7 4844.0 4885.0 4896.6 4873.9 5088.8 5213.9 5844.5 5967.8 3509.8 3517.2 4044.7 4090.6 4122.3 5066.5 6103.7 6227.8 6283.4 6325.6 4152.9 4163.0 4174.2 4181.6 4181.9 3781.3 4251.1 4254.4 4260.7 4288.3 3778.6 4984.3 5010.3 5012.9 5033.2 5950.3 5985.8 5995.2 6077.2 6139.5 1163.7 1354.6 1453.5 1459.0 1462.8 866.9 867.9 897.8 921.0 969.4 4860.3 5446.8 5536.5 5594.6 5631.1 5680.9 6122.5 6125.7 6142.8 6165.3 4650.8 5134.8 5322.6 5414.8 5627.8 2692.6 2837.7 3210.4 3248.5 3252.8 5296.8 5542.0 5887.4 6379.8 6447.0 5016.4 5623.3 6301.8 6327.4 6330.4 5847.5 6357.3 6385.0 6385.1 6450.9 5405.2 5809.7 5961.3 6058.7 6109.0 5648.0 6073.6 6089.2 6096.2 6121.2 5954.9 6211.0 6288.0 6306.7 6360.7 4117.8 4132.8 4133.3 4134.3 4150.5 5371.5 5504.7 5751.0 6117.4 6145.9 4861.6 5600.7 5951.6 5961.3 5984.6 4967.7 5377.7 5767.7 6064.1 6108.4 4349.7 5936.5 6000.0 6002.6 6037.3 5992.1 5992.6 6017.3 6046.3 6090.6 5937.9 5956.7 5976.7 5985.9 5999.6 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - PROCESS | 1708 | [#5] yui.html Cycles:180 Average:23885.48 Median:3940.68 stddev:38819.26 (985.1%) stddev-sans-first:38888.95 04:46:50 INFO - PROCESS | 1708 | Values: 646.7 711.9 719.2 791.4 811.0 15361.4 16141.1 16148.4 16185.8 16193.4 14561.7 14589.8 14709.0 14711.9 14714.6 674.3 807.8 816.2 817.9 843.7 831.7 844.7 846.0 847.9 848.3 875.9 883.9 890.8 893.7 895.2 873.0 885.2 885.6 889.6 891.1 645.5 648.6 655.0 655.2 659.1 14957.9 14962.7 14963.7 14994.4 15006.7 14677.6 14726.3 14781.2 14803.3 14808.6 11882.6 11979.2 12009.0 12048.3 12266.3 3851.5 3924.7 3937.5 4017.6 4094.2 121266.0 124760.0 126443.4 128164.0 129550.0 11093.9 11280.1 11309.7 11452.0 11667.7 22874.5 23134.5 23137.7 23147.0 23165.0 8300.0 8376.6 8424.5 8455.6 8590.4 3943.8 4505.3 4638.7 4644.1 4708.4 3012.9 3615.6 3645.2 3658.4 3692.4 563.6 573.9 651.9 661.9 665.7 576.6 597.1 602.9 656.5 679.3 9279.8 9467.8 9745.1 9864.4 9944.9 531.2 620.3 663.5 666.1 669.7 4493.3 4751.8 4753.8 4791.9 4801.4 129708.7 133465.0 149517.0 151184.0 178654.0 115001.4 117942.0 129544.0 130303.7 133806.0 72920.5 73895.3 78485.0 97883.4 104812.0 7436.0 8181.7 8764.9 8909.3 8917.2 46297.5 50634.0 57081.6 57285.4 60789.4 61573.0 85549.6 88980.6 89016.6 90691.2 11352.8 11607.9 11664.0 11680.6 11785.7 12451.6 12735.4 12797.3 12988.0 13117.1 11854.2 11896.8 11898.8 12014.3 12345.4 11799.9 11986.4 11990.6 12371.3 12478.3 9565.4 9753.5 11844.3 11871.6 12262.6 10094.4 10117.2 10234.5 10314.4 10367.2 9360.7 10268.0 10373.9 10485.4 10498.2 04:46:50 INFO - PROCESS | 1708 | -------- Summary: end -------- 04:46:50 INFO - PROCESS | 1708 | 04:46:50 INFO - TEST-INFO | 1708: exit 0 04:46:50 INFO - TEST-OK | dromaeo_css | took 1113573ms 04:46:50 INFO - TEST-START | kraken 04:46:50 INFO - operating with platform_type : mac_ 04:46:50 INFO - Initialising browser for kraken test... 04:46:50 INFO - TEST-INFO | started process 1716 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/tmp2zaVe8/profile http://localhost:49272/getInfo.html) 04:46:53 INFO - PROCESS | 1716 | __metrics Screen width/height:1600/1200 04:46:53 INFO - PROCESS | 1716 | colorDepth:24 04:46:53 INFO - PROCESS | 1716 | Browser inner width/height: 1024/689 04:46:53 INFO - PROCESS | 1716 | __metrics 04:46:53 ERROR - PROCESS | 1716 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 04:46:54 INFO - TEST-INFO | 1716: exit 0 04:46:54 INFO - Browser initialized. 04:46:54 INFO - Running cycle 1/1 for kraken test... 04:46:54 INFO - TEST-INFO | started process 1719 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/tmp2zaVe8/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:47:06 INFO - PROCESS | 1719 | RSS: Main: 239607808 04:47:06 INFO - PROCESS | 1719 | 04:47:09 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49272/tests/kraken/driver.html?testName=audio-beat-detection) 04:47:10 INFO - PROCESS | 1719 | RSS: Main: 252502016 04:47:10 INFO - PROCESS | 1719 | 04:47:12 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49272/tests/kraken/driver.html?testName=audio-dft) 04:47:13 INFO - PROCESS | 1719 | RSS: Main: 261148672 04:47:13 INFO - PROCESS | 1719 | 04:47:16 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49272/tests/kraken/driver.html?testName=audio-fft) 04:47:17 INFO - PROCESS | 1719 | RSS: Main: 264212480 04:47:17 INFO - PROCESS | 1719 | 04:47:19 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49272/tests/kraken/driver.html?testName=audio-oscillator) 04:47:20 INFO - PROCESS | 1719 | RSS: Main: 266600448 04:47:20 INFO - PROCESS | 1719 | 04:47:22 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49272/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:47:22 INFO - PROCESS | 1719 | RSS: Main: 267010048 04:47:22 INFO - PROCESS | 1719 | 04:47:26 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49272/tests/kraken/driver.html?testName=imaging-darkroom) 04:47:26 INFO - PROCESS | 1719 | RSS: Main: 267247616 04:47:26 INFO - PROCESS | 1719 | 04:47:29 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49272/tests/kraken/driver.html?testName=imaging-desaturate) 04:47:30 INFO - PROCESS | 1719 | RSS: Main: 267509760 04:47:30 INFO - PROCESS | 1719 | 04:47:33 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49272/tests/kraken/driver.html?testName=json-parse-financial) 04:47:34 INFO - PROCESS | 1719 | RSS: Main: 267677696 04:47:34 INFO - PROCESS | 1719 | 04:47:35 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49272/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:47:36 INFO - PROCESS | 1719 | RSS: Main: 267530240 04:47:36 INFO - PROCESS | 1719 | 04:47:38 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:47:38 INFO - PROCESS | 1719 | RSS: Main: 267620352 04:47:38 INFO - PROCESS | 1719 | 04:47:40 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:47:41 INFO - PROCESS | 1719 | RSS: Main: 267927552 04:47:41 INFO - PROCESS | 1719 | 04:47:44 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:47:45 INFO - PROCESS | 1719 | RSS: Main: 268062720 04:47:45 INFO - PROCESS | 1719 | 04:47:48 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:47:48 INFO - PROCESS | 1719 | RSS: Main: 268046336 04:47:48 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49272/tests/kraken/driver.html?testName=ai-astar) 04:47:50 INFO - PROCESS | 1719 | RSS: Main: 269217792 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | __start_tp_report 04:47:50 INFO - PROCESS | 1719 | _x_x_mozilla_page_load 04:47:50 INFO - PROCESS | 1719 | _x_x_mozilla_page_load_details 04:47:50 INFO - PROCESS | 1719 | |i|pagename|runs| 04:47:50 INFO - PROCESS | 1719 | |0;ai-astar;122;170;153;119;117;131;165;161;117;115 04:47:50 INFO - PROCESS | 1719 | |1;audio-beat-detection;142;109;132;161;131;165;159;113;159;115 04:47:50 INFO - PROCESS | 1719 | |2;audio-dft;203;212;215;198;193;199;192;191;198;197 04:47:50 INFO - PROCESS | 1719 | |3;audio-fft;72;82;105;178;52;61;77;84;152;49 04:47:50 INFO - PROCESS | 1719 | |4;audio-oscillator;68;68;117;70;72;76;116;70;73;116 04:47:50 INFO - PROCESS | 1719 | |5;imaging-gaussian-blur;136;130;90;101;135;81;136;130;118;86 04:47:50 INFO - PROCESS | 1719 | |6;imaging-darkroom;95;95;96;96;97;95;103;148;142;105 04:47:50 INFO - PROCESS | 1719 | |7;imaging-desaturate;99;86;147;149;118;89;110;89;149;84 04:47:50 INFO - PROCESS | 1719 | |8;json-parse-financial;56;57;59;57;57;61;57;57;57;60 04:47:50 INFO - PROCESS | 1719 | |9;json-stringify-tinderbox;63;68;67;69;82;74;73;71;70;68 04:47:50 INFO - PROCESS | 1719 | |10;stanford-crypto-aes;86;88;92;89;92;87;86;75;76;105 04:47:50 INFO - PROCESS | 1719 | |11;stanford-crypto-ccm;138;143;141;154;157;144;136;142;168;154 04:47:50 INFO - PROCESS | 1719 | |12;stanford-crypto-pbkdf2;181;219;183;152;219;233;175;169;172;169 04:47:50 INFO - PROCESS | 1719 | |13;stanford-crypto-sha256-iterative;70;68;69;67;68;72;73;80;89;74 04:47:50 INFO - PROCESS | 1719 | __end_tp_report 04:47:50 INFO - PROCESS | 1719 | __start_cc_report 04:47:50 INFO - PROCESS | 1719 | _x_x_mozilla_cycle_collect,1056 04:47:50 INFO - PROCESS | 1719 | __end_cc_report 04:47:50 INFO - PROCESS | 1719 | __startTimestamp1471175270949__endTimestamp 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | ------- Summary: start ------- 04:47:50 INFO - PROCESS | 1719 | Number of tests: 14 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#0] ai-astar Cycles:10 Average:137.00 Median:142.00 stddev:22.54 (15.9%) stddev-sans-first:23.25 04:47:50 INFO - PROCESS | 1719 | Values: 122.0 170.0 153.0 119.0 117.0 131.0 165.0 161.0 117.0 115.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#1] audio-beat-detection Cycles:10 Average:138.60 Median:150.50 stddev:21.69 (14.4%) stddev-sans-first:22.97 04:47:50 INFO - PROCESS | 1719 | Values: 142.0 109.0 132.0 161.0 131.0 165.0 159.0 113.0 159.0 115.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#2] audio-dft Cycles:10 Average:199.80 Median:198.50 stddev:8.09 (4.1%) stddev-sans-first:8.50 04:47:50 INFO - PROCESS | 1719 | Values: 203.0 212.0 215.0 198.0 193.0 199.0 192.0 191.0 198.0 197.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#3] audio-fft Cycles:10 Average:91.20 Median:66.50 stddev:42.63 (64.1%) stddev-sans-first:44.65 04:47:50 INFO - PROCESS | 1719 | Values: 72.0 82.0 105.0 178.0 52.0 61.0 77.0 84.0 152.0 49.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#4] audio-oscillator Cycles:10 Average:84.60 Median:70.00 stddev:22.03 (31.5%) stddev-sans-first:22.53 04:47:50 INFO - PROCESS | 1719 | Values: 68.0 68.0 117.0 70.0 72.0 76.0 116.0 70.0 73.0 116.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#5] imaging-gaussian-blur Cycles:10 Average:114.30 Median:136.00 stddev:22.49 (16.5%) stddev-sans-first:22.45 04:47:50 INFO - PROCESS | 1719 | Values: 136.0 130.0 90.0 101.0 135.0 81.0 136.0 130.0 118.0 86.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#6] imaging-darkroom Cycles:10 Average:107.20 Median:95.00 stddev:20.27 (21.3%) stddev-sans-first:21.02 04:47:50 INFO - PROCESS | 1719 | Values: 95.0 95.0 96.0 96.0 97.0 95.0 103.0 148.0 142.0 105.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#7] imaging-desaturate Cycles:10 Average:112.00 Median:85.00 stddev:27.26 (32.1%) stddev-sans-first:28.51 04:47:50 INFO - PROCESS | 1719 | Values: 99.0 86.0 147.0 149.0 118.0 89.0 110.0 89.0 149.0 84.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#8] json-parse-financial Cycles:10 Average:57.80 Median:57.00 stddev:1.62 (2.8%) stddev-sans-first:1.58 04:47:50 INFO - PROCESS | 1719 | Values: 56.0 57.0 59.0 57.0 57.0 61.0 57.0 57.0 57.0 60.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#9] json-stringify-tinderbox Cycles:10 Average:70.50 Median:70.50 stddev:5.10 (7.2%) stddev-sans-first:4.64 04:47:50 INFO - PROCESS | 1719 | Values: 63.0 68.0 67.0 69.0 82.0 74.0 73.0 71.0 70.0 68.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#10] stanford-crypto-aes Cycles:10 Average:87.60 Median:87.50 stddev:8.45 (9.7%) stddev-sans-first:8.94 04:47:50 INFO - PROCESS | 1719 | Values: 86.0 88.0 92.0 89.0 92.0 87.0 86.0 75.0 76.0 105.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#11] stanford-crypto-ccm Cycles:10 Average:147.70 Median:149.00 stddev:10.12 (6.8%) stddev-sans-first:10.11 04:47:50 INFO - PROCESS | 1719 | Values: 138.0 143.0 141.0 154.0 157.0 144.0 136.0 142.0 168.0 154.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:187.20 Median:182.00 stddev:26.79 (14.7%) stddev-sans-first:28.32 04:47:50 INFO - PROCESS | 1719 | Values: 181.0 219.0 183.0 152.0 219.0 233.0 175.0 169.0 172.0 169.0 04:47:50 INFO - PROCESS | 1719 | 04:47:50 INFO - PROCESS | 1719 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:73.00 Median:72.50 stddev:6.82 (9.4%) stddev-sans-first:7.14 04:47:50 INFO - PROCESS | 1719 | Values: 70.0 68.0 69.0 67.0 68.0 72.0 73.0 80.0 89.0 74.0 04:47:50 INFO - PROCESS | 1719 | -------- Summary: end -------- 04:47:50 INFO - PROCESS | 1719 | 04:47:51 INFO - TEST-INFO | 1719: exit 0 04:47:51 INFO - TEST-OK | kraken | took 60872ms 04:47:51 INFO - SUITE-END | took 1174s 04:47:52 INFO - Completed test suite (00:19:34) 04:47:52 INFO - javascript benchmark 04:47:52 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7414.4484693353525, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3400.387930172569, 3406.812625305609, 3428.8971330860077, 3430.6740859618326, 3465.2549701814105, 5583.637063590863, 5778.422157784219, 5832.416758324171, 5833.358330583643, 5843.503302219311, 4331.891702707434, 5819.418058194178, 5829.125631155329, 5840.386759390267, 5896.941030589693, 5253.44838791928, 5302.469753024705, 5323.893522129574, 5346.27825243591, 5394.406615272317, 4399.450068741407, 5205.557527610158, 5231.26762253283, 5301.655392399501, 5330.653507522018, 5255.343082114755, 5281.234221037928, 5288.338957630296, 5307.601929855257, 5309.548688361494, 5260.473952604747, 5272.947270527322, 5313.38896026958, 5322.627416080876, 5364.034473794715, 5150.61370397218, 5190.506901844319, 5271.077561426735, 5299.4435584263865, 5304.575633949314, 5778.219940308047, 5818.41815818419, 5838.2118414013985, 5839.065749480105, 5895.086261629454, 6210.285817131043, 6276.184096067527, 6291.968540157316, 6302.306746257908, 6302.4958003359625, 6211.81364559064, 6218.253809542839, 6225.501959843202, 6251.562390632657, 6266.655333956631, 4933.703977761345, 5899.67551784656, 5954.0, 5965.373635768268, 6024.09638554216, 6230.937690623035, 6297.653629050446, 6301.590396624205, 6318.684065796691, 6330.272018717907, 5242.370915490165, 6125.20492926512, 6186.0, 6237.438630523275, 6246.312905580383, 5844.766209351578, 5986.610870293504, 6233.844153896189, 6255.611196456676, 6315.936840631535, 5208.557272631793, 6229.813105606839, 6271.62370257786, 6275.905861412082, 6284.057391391328, 6165.722542485599, 6169.629822210682, 6227.844303892349, 6250.124982502453, 6321.146645202839, 4999.700017998932, 5007.549320561094, 5016.949830501649, 5019.874503137451, 5020.171671674206, 4509.549045095464, 4518.683692141519, 4525.208088584484, 4530.161920044802, 4557.316402539645, 5862.14998825168, 5879.412058794086, 5985.371535988658, 6023.096535519707, 6034.728437220336, 5157.742112894341, 6253.6560489173535, 6290.685465726695, 6296.181496405529, 6403.551751377452, 5985.670788106609, 5995.970020149958, 5997.55018373615, 6011.729472173763, 6030.517558595302, 5456.563474921997, 5457.345118585795, 5467.863303417446, 5506.91739623906, 5512.751926163332, 5340.759665815125, 6335.619862808247, 6338.366163383625, 6372.681365931685, 6382.393672601095, 6222.439980401786, 6232.065190221322, 6270.435660790551, 6275.874482510416, 6281.057841323838, 6232.407921247474, 6300.495960323072, 6302.684865756785, 6356.2054743157105, 6363.268224154282, 5307.01820163271, 6246.593971391845, 6278.466330361788, 6291.937080629318, 6294.874102518015, 5615.719214039364, 6262.405071518198, 6275.184226050585, 6290.150829637941, 6291.937080629135, 6138.478229350377, 6142.590862071594, 6175.042868355412, 6187.81436556904, 6231.470325022243, 4698.248280275139, 6218.81343559694, 6220.471259942956, 6235.095911092957, 6241.937580624136, 5012.172991456515, 5590.301212348457, 5961.821145365646, 6136.846578835565, 6139.508839292756, 6143.354947730602, 6153.077038444269, 6170.413810687977, 6178.721957511832, 6246.437820596168, 6101.786437474844, 6131.713108457195, 6150.477209437248, 6159.23009623797, 6160.661163636043], "value": 5720.385646601819, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [507.5989967925339, 520.9739513024348, 527.4751622135975, 532.5819231902957, 548.3091304955755, 39342.409863852066, 41483.37774933375, 41643.37534936978, 41888.79055604725, 41927.3710894336, 42680.0, 43185.13629727404, 43397.56602433975, 43456.782716086374, 43480.13039739204, 9691.418514889094, 9904.405735655848, 9915.058069483424, 9922.057404546556, 9937.453440060794, 9734.221262299, 9831.90168098317, 9859.0, 9871.407715537054, 9886.752831179243, 9849.704508864745, 9875.851862222073, 9903.306768526207, 9909.256805739562, 9924.305298629099, 9826.754331141707, 9843.212542996544, 9861.506924653739, 9864.60541578336, 9868.161206297473, 9669.70990870275, 9748.0, 9749.658761943369, 9755.02449755026, 9760.658376956844, 39843.40234896479, 40747.796261018506, 40771.1845763086, 41031.0, 41093.38359924604, 3358.932821343584, 3430.047575827089, 3851.5763266040713, 3853.325668008087, 4105.220008198433, 22918.083276668913, 30952.0, 31162.688373116205, 31322.06033818989, 32571.0, 3214.4214041472524, 3264.0, 3387.61042480113, 3418.384690755663, 3442.9311413771584, 486003.0, 488118.0, 513115.0, 514834.0, 514872.0, 61302.69348653317, 61561.76876462446, 61581.692091539255, 61612.69193654093, 62856.685716571126, 64030.67984660047, 64120.35879641144, 64269.678651606446, 64747.35252647507, 64831.67584162049, 16510.257038433298, 16621.66756664884, 16624.0, 16734.330626775038, 16746.246418910934, 12802.743945121045, 12909.54816581415, 12931.030172737082, 12931.741365172644, 12969.221846689228, 16855.0, 17604.71138751954, 17699.469015929542, 17700.645987080185, 17718.291268349378, 6065.878682426415, 6368.044793280952, 6648.83377915556, 6683.198016237985, 6725.562838415487, 885.5395194498825, 960.9135177834029, 970.8106919150839, 982.3663736889808, 990.9851352229722, 33163.17092072718, 33568.832155839555, 34316.48525272123, 34701.47947780785, 34858.65141348554, 987.1313244344931, 1114.660028691257, 1154.157465050501, 1166.3410173252084, 1186.5846953566356, 15133.621659458602, 15750.606234843992, 15759.921200393925, 15765.605859853365, 16185.352585896668, 684796.0, 693981.0, 700406.4817083244, 705773.0, 705814.0, 59210.703946480855, 60042.69978650079, 60471.39528604745, 60497.69751151216, 60548.39451605516, 1355.1801160297878, 1433.6702558411623, 1460.7808828675784, 1464.3044553836842, 1464.4142343062647, 27197.320066998484, 30872.53691194589, 31868.0, 32143.0, 32954.83522582372, 53118.0, 53852.730736346064, 53908.0, 53966.98429204335, 54042.0, 580564.0, 583206.0, 586791.0, 586807.0, 590252.0, 43629.56370436255, 44580.0, 45331.0, 45489.77255113703, 45536.31695524636, 49172.0, 49890.0, 50170.24744628907, 50572.98854022972, 50731.49268507268, 40879.795601021804, 41025.384619231336, 41086.794566026976, 41234.175316494104, 42122.94692632709, 40209.99475013148, 40963.7951810239, 41056.58943410647, 41228.969275767144, 41913.58086419097, 33180.83409582936, 38146.809265953496, 39463.81608551748, 40124.598754012084, 40130.39804402995, 35450.0, 35705.82147089352, 36004.09989750277, 36463.63536364709, 36940.63059369372, 25777.355566110247, 26058.087966921066, 26220.475590488466, 26545.203643890713, 26845.865770671022], "value": 20840.368106515103, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [350.66686647684696, 371.1630273732734, 379.3418419042961, 381.34789509938, 400.23155541360586, 20281.290154844584, 20327.49181270469, 21943.0, 21943.0, 22090.11639534421, 12022.0, 12191.817122743167, 15268.778497720183, 19772.50568735782, 20317.593648127066, 4585.495595484511, 5136.486351364871, 5296.834696366793, 5523.392426833045, 6010.669413182273, 4237.258479766044, 5456.61803673743, 5505.559555235592, 5506.972465137669, 5510.448955104497, 5373.489518495756, 5378.542823859957, 5499.917501237484, 5501.064818980783, 5506.421825708303, 5163.328767260251, 5892.440218179266, 6006.099085137221, 6017.608855424383, 6019.157317975443, 5141.0, 5290.867728306785, 5304.416514183436, 5312.415634280226, 5368.248445217672, 13419.0, 13519.86480135196, 17729.113544322732, 25281.494370112494, 25632.615510767355, 2186.7047948527065, 2453.8773061347038, 2477.962830557543, 2932.398858234057, 3007.1429642551766, 9424.387414818084, 9726.90273097267, 9744.07431294026, 9957.302988790787, 10233.48832558369, 1839.8988055656935, 1851.518605162654, 1860.674381983161, 1879.0886420086247, 1882.585831117152, 88087.55956220243, 109632.4518377403, 112504.43747781208, 114286.0, 114299.42850285779, 11344.943275283737, 11443.427828608535, 11560.30638161713, 11583.07335413165, 11735.0, 14313.28433578317, 14493.637659058608, 14507.347169377403, 14525.201113938623, 14529.709405812036, 7982.0, 8426.4944103354, 8574.0, 8605.354598405145, 8745.169208925143, 7758.013164931542, 8296.543690097102, 8497.362697797565, 8529.872051919227, 8736.825263494695, 3452.8618855246013, 4296.668032909808, 4488.685791994594, 4496.437945256843, 4594.0, 1847.6918728335675, 1917.769867615867, 1934.5453818352676, 1950.5611237471455, 1993.3421970749619, 849.4096602861076, 888.6891834543995, 897.2866571076011, 900.2078171209293, 924.6994726713845, 17391.130443477774, 20187.293444729363, 20633.89683051575, 20685.793142068687, 20687.17251309961, 936.1434287626745, 959.5490119643756, 970.9320347575743, 993.7764003099389, 1030.7989941961396, 10127.64553240633, 10535.157187424988, 10601.946990265154, 10632.734181645521, 10653.520591573399, 604733.0, 605459.0, 612563.0, 621816.0, 633686.0, 94405.0, 129988.0, 132684.0, 140079.5992040087, 147261.0, 977.9706608801605, 1000.2098342309494, 1003.7440452684665, 1016.3038318751679, 1017.2828156149897, 14913.552593422215, 17137.88603740753, 18817.6236475267, 19472.61054778868, 20068.698969515175, 45151.77424112859, 54531.454685452634, 56551.15173272322, 56657.15014274872, 57715.1342729851, 79151.4169716591, 80313.79529306949, 80553.19446805457, 80970.0, 83750.0, 7984.24149705777, 8066.878996814935, 8253.463524870864, 8259.793505162419, 8393.790155246168, 11853.822192666945, 12503.312317822607, 12534.247945123321, 12899.742005160031, 13446.596602101952, 10796.244262901522, 10974.890251097388, 11175.441227938732, 11368.602098926498, 11382.715432114263, 10861.837072443761, 10933.125349972142, 11240.156988225752, 11260.98651121403, 11441.42792860337, 10911.0, 11347.886521134684, 11533.0, 11696.005839503738, 11751.88248117542, 8035.196480351918, 8212.46618969765, 8221.383396245425, 8260.545669987969, 8484.660613575388, 8390.496570205807, 11181.0, 11426.25729327591, 11635.76728465409, 11775.0], "value": 9345.245546812377, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1528.7095451864147, 1554.5569512688883, 1751.9926042525542, 1808.8372046515829, 1811.1940186616944, 7921.643526041327, 8440.831183376336, 8787.12128787121, 9021.413608115476, 9046.819063618723, 8733.083026282244, 8911.73264802057, 8927.821443571125, 8936.508492032935, 8938.86591701125, 2343.543009113228, 2389.4026493376655, 2390.5537150024247, 2391.760823917603, 2400.31590996566, 2362.3621622162004, 2373.857568545884, 2406.181898154627, 2410.4693519615084, 2414.4929564791414, 1890.8770929889513, 2260.378395941121, 2290.6678531612906, 2302.9884850575722, 2303.366574192094, 2349.9882500587387, 2359.528094381131, 2369.3247424484025, 2375.4180225844607, 2375.667406563074, 2353.317537914003, 2370.2415227127326, 2371.9407014824596, 2375.4655202579456, 2377.8573285602747, 8810.339224558184, 8934.821303573957, 8973.685920992733, 8974.596143173572, 8982.281417486585, 5285.07511185541, 5302.814401495929, 5335.279737235501, 5383.838484845461, 5401.43284955078, 3539.7168226541817, 3666.724995625312, 3668.6881615062753, 3732.850685972558, 3739.607341229159, 1075.2097208551709, 1107.5901916290943, 1108.3405373802575, 1114.0975809594254, 1128.6783266769014, 11441.885581144164, 11564.76870462586, 11573.594924177612, 11596.826047609293, 11634.883651163549, 4557.339185818038, 4680.7191568506, 4837.879053023703, 4870.293807397908, 4883.682560633548, 8942.776430589287, 8943.731688049369, 9877.703668889944, 9925.900740992642, 9939.254555908336, 5334.333208348957, 5366.517013468807, 5373.435789242073, 5373.677579345173, 5375.381831089397, 4479.17135329965, 4821.397325334333, 4918.926216106761, 4936.407631084293, 4972.030454061423, 3417.2652879631, 3891.922161556753, 3969.126792105732, 4023.8994025149605, 4091.8158682859344, 1293.6765808547864, 1297.2151848131932, 1299.8635143310005, 1301.7721898667696, 1318.406716977364, 903.4850135422878, 937.7280588629358, 938.7561481037652, 948.8956214816365, 971.9951400242953, 4642.489326174118, 5414.269073675082, 5980.910286345621, 6095.652562707711, 6192.318844927055, 437.372370648121, 440.8324836562086, 447.73136118328745, 451.38160719814067, 454.75670516274295, 3994.4407782910416, 4005.439238506611, 4087.550369459357, 4116.794160291974, 4123.2165888481095, 9891.950540247253, 10884.0, 10949.397783122005, 10967.83548246777, 10972.0, 10903.073238774634, 10917.836232456519, 10940.507677154546, 10954.561817527368, 10970.506327215295, 7837.529748215125, 8264.462809917337, 8270.793230169174, 8312.501249924902, 8370.581470926429, 5918.556108291809, 5990.670513121646, 6026.168744655896, 6139.1098290746695, 6274.749010039547, 9968.950155249177, 10170.440625765654, 10184.592616295266, 10211.948940255252, 10213.693589192337, 9543.0, 9809.068138526829, 9871.605135794487, 9967.252456065678, 9978.0, 6947.652617369213, 7350.301721336678, 7472.663730132266, 7544.66049027806, 7639.541627502367, 8444.535550544779, 8528.914710852812, 8553.786155346166, 8561.657533698582, 8588.0, 7510.286522780327, 7540.514161997222, 7597.278258565428, 7714.614269286625, 7781.883271750815, 7412.407007439284, 7479.289467500579, 7507.699692012258, 7562.962185189039, 7679.539227646359, 6834.760783372558, 6928.896066559107, 6947.861042779015, 6966.059581956371, 6988.266232045562, 4541.818327267005, 4828.66199366041, 4955.132851751001, 5055.898882022412, 5145.842185508231, 4954.108260513142, 4986.376702912136, 5027.74861256943, 5083.364579427572, 5207.609429292894], "value": 4534.316020384489, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [311.4502902377304, 315.8704930978298, 318.3553304558269, 322.969317914798, 324.4613940858173, 5330.374235858062, 5769.653820770756, 5846.678432686201, 5855.765769369225, 5869.7652093916295, 5177.508136727014, 5452.609584555933, 5734.340550836655, 5740.7129643517765, 5806.4483874032, 4082.9792551862033, 4184.832606695729, 4256.914861702764, 4309.245881970658, 4327.394164816928, 3870.9225815483674, 4036.374361973884, 4280.486341639008, 4292.5278219396, 4344.45694288214, 3706.962930370689, 4269.6370808481315, 4311.611954924057, 4343.609075183249, 4354.782260886959, 3960.485136932209, 4086.9795651021705, 4247.384129301234, 4258.339957306592, 4335.9187589957, 3686.4470329450796, 3710.591834898159, 3726.5341832270965, 3742.981285093584, 3745.2883952049297, 4523.660725445572, 4635.907281854378, 5186.0, 5607.327120745495, 5612.242347283105, 4348.043430445297, 4566.70316429431, 4843.975780121112, 4885.0, 4896.608271338285, 4873.926891096601, 5088.804131029206, 5213.921791173136, 5844.4739973402175, 5967.761289548413, 3509.842057107436, 3517.2262102337445, 4044.716869819114, 4090.5704900985265, 4122.2579935611575, 5066.505380912639, 6103.72533236001, 6227.813165605039, 6283.392392157295, 6325.627889541422, 4152.854650087233, 4163.044238590574, 4174.246816337085, 4181.6236538711055, 4181.916361672749, 3781.3193625147737, 4251.128518653669, 4254.404383386328, 4260.744355338689, 4288.335308027261, 3778.6306797078123, 4984.252362145635, 5010.323606313174, 5012.914474703105, 5033.219850923113, 5950.345461999176, 5985.7904973326595, 5995.2206213192, 6077.24034495688, 6139.539534534928, 1163.7323415614455, 1354.607163922471, 1453.5203382883624, 1458.9781153282709, 1462.817147856518, 866.9380009488326, 867.9349048821364, 897.8294124116397, 920.963161473547, 969.4280374579032, 4860.295257187759, 5446.782128714886, 5536.501714845684, 5594.636348637326, 5631.057285236587, 5680.857978550486, 6122.479589234876, 6125.693715314216, 6142.754289828446, 6165.260168779775, 4650.790714417859, 5134.794608215704, 5322.627416080914, 5414.83755487336, 5627.803026894039, 2692.649955505811, 2837.7020412856764, 3210.3739770744946, 3248.514886112126, 3252.821094839759, 5296.814611488579, 5541.972290138604, 5887.4406931341455, 6379.776707815204, 6447.0, 5016.398032236082, 5623.297087864017, 6301.794371969774, 6327.430531252209, 6330.39861213184, 5847.526642118783, 6357.327364387172, 6384.968075159594, 6385.13800636908, 6450.935490645127, 5405.243265942692, 5809.651420914759, 5961.254843144607, 6058.7273572688455, 6108.969455152695, 5648.046367542819, 6073.574849760651, 6089.1779609753885, 6096.177016102947, 6121.204243448323, 5954.940450595439, 6210.968945155245, 6287.962486189727, 6306.707125039265, 6360.650164241011, 4117.835286588503, 4132.772697501667, 4133.256013917524, 4134.297169481256, 4150.460440142762, 5371.462853714597, 5504.724763761716, 5751.022326204639, 6117.388261173847, 6145.877082458415, 4861.562459378673, 5600.747966341606, 5951.577842740355, 5961.333779725524, 5984.551158663031, 4967.726775027409, 5377.650452720561, 5767.653940763567, 6064.090386441892, 6108.419700128481, 4349.652027837702, 5936.476997276054, 6000.0, 6002.639841609517, 6037.347404820196, 5992.101184822312, 5992.580519363602, 6017.2779266488305, 6046.3046749624355, 6090.573659843769, 5937.881242375042, 5956.731947062306, 5976.731047102804, 5985.940140598538, 5999.590301128755], "value": 4336.88995474761, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [646.7348387161263, 711.89677496763, 719.2124623537227, 791.3510921044739, 810.975670729878, 15361.385544578217, 16141.09460297149, 16148.354065837353, 16185.75721364179, 16193.433229836957, 14561.708765824676, 14589.781153282709, 14709.043912145704, 14711.852881471183, 14714.558563243094, 674.349252970883, 807.7617102954642, 816.2286639126029, 817.914119017502, 843.6836186430089, 831.7296878514477, 844.7085755414372, 845.9577021148949, 847.8601030829906, 848.2832006954114, 875.9211670949613, 883.9116088391141, 890.7951171230621, 893.7363477774039, 895.234574438852, 872.9956350218208, 885.154677283193, 885.579349808842, 889.6308032166643, 891.095538028898, 645.4739387399302, 648.6367634124905, 654.9913133773982, 655.2104713819836, 659.0575477067791, 14957.850421495754, 14962.70074598502, 14963.728083112948, 14994.400223991028, 15006.699866002618, 14677.55967320982, 14726.263686815617, 14781.187034713086, 14803.259837008214, 14808.629784255372, 11882.58410955621, 11979.161458697807, 12009.0, 12048.277103373826, 12266.338791259264, 3851.5378154621626, 3924.7056470764524, 3937.5078115235597, 4017.5580686124504, 4094.2220978014084, 121266.04652556185, 124760.0, 126443.36778316142, 128164.0, 129550.0, 11093.944530277297, 11280.097592192606, 11309.71725706864, 11452.0, 11667.708307292216, 22874.542509149724, 23134.53730925372, 23137.652935205984, 23147.0, 23165.0, 8299.958500207582, 8376.612665390334, 8424.4945303282, 8455.619497122521, 8590.441621294722, 3943.842246310173, 4505.301678239878, 4638.675292729544, 4644.0944015916575, 4708.364370809965, 3012.9397412052076, 3615.5661320641166, 3645.2345007548183, 3658.396364599811, 3692.3538380783257, 563.6420872745836, 573.9110437882135, 651.8956966885371, 661.9338066193438, 665.6738198282903, 576.6132451454259, 597.0536699331522, 602.9005214139705, 656.4551422319558, 679.3037136934582, 9279.76800579991, 9467.76330591727, 9745.125944208381, 9864.408135511892, 9944.900550994542, 531.1899353485965, 620.2649859916014, 663.4924282923567, 666.120720648739, 669.7053296549502, 4493.303537951622, 4751.809927602926, 4753.808182294161, 4791.924390123227, 4801.447833499123, 129708.70291297155, 133465.0, 149517.0, 151184.0, 178654.0, 115001.42499287617, 117942.0, 129544.0, 130303.69696303105, 133806.0, 72920.54158916791, 73895.26104738991, 78485.0, 97883.40215358917, 104812.0, 7435.997167619087, 8181.713640022571, 8764.868526972228, 8909.331800114887, 8917.152870477294, 46297.53702463067, 50634.0, 57081.57296067465, 57285.42714572801, 60789.392106080144, 61573.0, 85549.57225213834, 88980.5550972241, 89016.5549172276, 90691.21014268103, 11352.829707554229, 11607.883921161017, 11664.008559272557, 11680.649580512598, 11785.705357366134, 12451.564195253122, 12735.363231838557, 12797.29614871191, 12988.0, 13117.147385419918, 11854.170208085352, 11896.821547676618, 11898.76202475963, 12014.279143251433, 12345.382730863601, 11799.941000294944, 11986.400679966142, 11990.580329688419, 12371.257724536557, 12478.313692746986, 9565.426074435556, 9753.463559504295, 11844.28934263947, 11871.643850684493, 12262.570810021607, 10094.444805535471, 10117.19062475015, 10234.53944572511, 10314.381137131797, 10367.222458315506, 9360.660143535388, 10268.024537668909, 10373.896261037293, 10485.423301718478, 10498.160147188053], "value": 7582.57192491766, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1608.5, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [122.0, 170.0, 153.0, 119.0, 117.0, 131.0, 165.0, 161.0, 117.0, 115.0], "value": 137.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 109.0, 132.0, 161.0, 131.0, 165.0, 159.0, 113.0, 159.0, 115.0], "value": 138.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [203.0, 212.0, 215.0, 198.0, 193.0, 199.0, 192.0, 191.0, 198.0, 197.0], "value": 199.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 82.0, 105.0, 178.0, 52.0, 61.0, 77.0, 84.0, 152.0, 49.0], "value": 91.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 117.0, 70.0, 72.0, 76.0, 116.0, 70.0, 73.0, 116.0], "value": 84.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 130.0, 90.0, 101.0, 135.0, 81.0, 136.0, 130.0, 118.0, 86.0], "value": 114.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 96.0, 96.0, 97.0, 95.0, 103.0, 148.0, 142.0, 105.0], "value": 107.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [99.0, 86.0, 147.0, 149.0, 118.0, 89.0, 110.0, 89.0, 149.0, 84.0], "value": 112.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 57.0, 59.0, 57.0, 57.0, 61.0, 57.0, 57.0, 57.0, 60.0], "value": 57.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 68.0, 67.0, 69.0, 82.0, 74.0, 73.0, 71.0, 70.0, 68.0], "value": 70.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 88.0, 92.0, 89.0, 92.0, 87.0, 86.0, 75.0, 76.0, 105.0], "value": 87.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [138.0, 143.0, 141.0, 154.0, 157.0, 144.0, 136.0, 142.0, 168.0, 154.0], "value": 147.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [181.0, 219.0, 183.0, 152.0, 219.0, 233.0, 175.0, 169.0, 172.0, 169.0], "value": 187.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 68.0, 69.0, 67.0, 68.0, 72.0, 73.0, 80.0, 89.0, 74.0], "value": 73.0, "unit": "score"}]}]} 04:47:52 INFO - Return code: 0 04:47:52 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:47:52 ERROR - # TBPL SUCCESS # 04:47:52 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 04:47:52 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 04:47:52 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 04:47:52 INFO - 2016-08-14 04:47:52.272 screenresolution[1724:24479] starting screenresolution argv=screenresolution get 04:47:52 INFO - 2016-08-14 04:47:52.275 screenresolution[1724:24479] Display 0: 1600x1200x32@60 04:47:52 INFO - 2016-08-14 04:47:52.281 screenresolution[1725:24482] starting screenresolution argv=screenresolution list 04:47:52 INFO - Available Modes on Display 0 04:47:52 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 04:47:52 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 04:47:52 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 04:47:52 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 04:47:52 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 04:47:52 INFO - Intel Iris: 04:47:52 INFO - Chipset Model: Intel Iris 04:47:52 INFO - Type: GPU 04:47:52 INFO - Bus: Built-In 04:47:52 INFO - VRAM (Dynamic, Max): 1536 MB 04:47:52 INFO - Vendor: Intel (0x8086) 04:47:52 INFO - Device ID: 0x0a2e 04:47:52 INFO - Revision ID: 0x0009 04:47:52 INFO - Displays: 04:47:52 INFO - Display: 04:47:52 INFO - Resolution: 1600 x 1200 @ 60 Hz 04:47:52 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 04:47:52 INFO - Display Serial Number: 1600x1200 60 04:47:52 INFO - Main Display: Yes 04:47:52 INFO - Mirror: Off 04:47:52 INFO - Online: Yes 04:47:52 INFO - Rotation: Supported 04:47:52 INFO - Return code: 0 04:47:52 INFO - Running post-action listener: _resource_record_post_action 04:47:52 INFO - [mozharness: 2016-08-14 11:47:52.517468Z] Finished run-tests step (success) 04:47:52 INFO - Running post-run listener: _resource_record_post_run 04:47:52 INFO - Total resource usage - Wall time: 1209s; CPU: 54.0%; Read bytes: 32492544; Write bytes: 707663872; Read time: 197; Write time: 1980 04:47:52 INFO - TinderboxPrint: CPU usage
54.4% 04:47:52 INFO - TinderboxPrint: I/O read bytes / time
32,492,544 / 197 04:47:52 INFO - TinderboxPrint: I/O write bytes / time
707,663,872 / 1,980 04:47:52 INFO - TinderboxPrint: CPU idle
2,206.6 (45.6%) 04:47:52 INFO - TinderboxPrint: CPU system
972.5 (20.1%) 04:47:52 INFO - TinderboxPrint: CPU user
1,658.5 (34.3%) 04:47:52 INFO - TinderboxPrint: Swap in / out
433,229,824 / 0 04:47:52 INFO - install - Wall time: 34s; CPU: 55.0%; Read bytes: 400419328; Write bytes: 394860544; Read time: 29660; Write time: 786 04:47:52 INFO - run-tests - Wall time: 1176s; CPU: 54.0%; Read bytes: 30395392; Write bytes: 298827776; Read time: 176; Write time: 1150 04:47:52 INFO - Running post-run listener: _upload_blobber_files 04:47:52 INFO - Blob upload gear active. 04:47:52 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:47:52 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 04:47:52 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'] 04:47:52 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 04:47:53 INFO - (blobuploader) - INFO - Open directory for files ... 04:47:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:47:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:47:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:47:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:47:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:47:54 INFO - (blobuploader) - INFO - Done attempting. 04:47:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:47:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:47:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:47:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:47:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:47:55 INFO - (blobuploader) - INFO - Done attempting. 04:47:55 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:47:55 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:47:55 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:47:57 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:47:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:47:57 INFO - (blobuploader) - INFO - Done attempting. 04:47:57 INFO - (blobuploader) - INFO - Iteration through files over. 04:47:57 INFO - Return code: 0 04:47:57 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:47:57 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:47:57 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0aa0e361506ca5f8a87e256febdfd8e0f3cc49b642e94a2295c9adb8cd51d2956c941ade4ed408d53092419cea2f4659ac1623d07b69443edcc4a170406cd80d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ba4ee84cc37b17eef6e236d7ddb64baabb167887ecb3527216337a2688d19129aa547060f78e72bfb04604b40017c8824acffcf5a614b1a035b0bc033e823597", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/04887ea025c46a10f3a30c5829fda6b4fb6b56e31cac0aadfba7380b95a8d75795befd011576ee52c9410a8c25b104502d06b59a1da4cdf3358ece5a47af18f4"} 04:47:57 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:47:57 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:47:57 INFO - Contents: 04:47:57 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0aa0e361506ca5f8a87e256febdfd8e0f3cc49b642e94a2295c9adb8cd51d2956c941ade4ed408d53092419cea2f4659ac1623d07b69443edcc4a170406cd80d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ba4ee84cc37b17eef6e236d7ddb64baabb167887ecb3527216337a2688d19129aa547060f78e72bfb04604b40017c8824acffcf5a614b1a035b0bc033e823597", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/04887ea025c46a10f3a30c5829fda6b4fb6b56e31cac0aadfba7380b95a8d75795befd011576ee52c9410a8c25b104502d06b59a1da4cdf3358ece5a47af18f4"} 04:47:57 INFO - Running post-run listener: copy_logs_to_upload_dir 04:47:57 INFO - Copying logs to upload dir... 04:47:57 INFO - mkdir: /builds/slave/test/build/upload/logs 04:47:57 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1274.654192 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 14 secs) (at 2016-08-14 04:47:57.814009) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 2 secs) (at 2016-08-14 04:47:57.817311) ========= 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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0aa0e361506ca5f8a87e256febdfd8e0f3cc49b642e94a2295c9adb8cd51d2956c941ade4ed408d53092419cea2f4659ac1623d07b69443edcc4a170406cd80d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ba4ee84cc37b17eef6e236d7ddb64baabb167887ecb3527216337a2688d19129aa547060f78e72bfb04604b40017c8824acffcf5a614b1a035b0bc033e823597", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/04887ea025c46a10f3a30c5829fda6b4fb6b56e31cac0aadfba7380b95a8d75795befd011576ee52c9410a8c25b104502d06b59a1da4cdf3358ece5a47af18f4"} build_url:https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010842 build_url: 'https://queue.taskcluster.net/v1/task/Y2akdAwGSBeipoOWBC4VTw/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/0aa0e361506ca5f8a87e256febdfd8e0f3cc49b642e94a2295c9adb8cd51d2956c941ade4ed408d53092419cea2f4659ac1623d07b69443edcc4a170406cd80d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ba4ee84cc37b17eef6e236d7ddb64baabb167887ecb3527216337a2688d19129aa547060f78e72bfb04604b40017c8824acffcf5a614b1a035b0bc033e823597", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/04887ea025c46a10f3a30c5829fda6b4fb6b56e31cac0aadfba7380b95a8d75795befd011576ee52c9410a8c25b104502d06b59a1da4cdf3358ece5a47af18f4"}' ========= master_lag: 2.85 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 2 secs) (at 2016-08-14 04:48:00.674764) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-14 04:48:00.675161) ========= 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.6ngpxpoJgJ/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.wa9JHVybTI/Listeners TMPDIR=/var/folders/yv/7cgcw59j42ddm7qwtql8l57m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005049 ========= master_lag: 0.28 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-14 04:48:00.957630) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-14 04:48:00.958170) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-14 04:48:00.959480) ========= ========= Total master_lag: 3.29 =========