builder: mozilla-central_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0199 starttime: 1471888240.44 results: success (0) buildid: 20160822082914 builduid: 830706a6bcc241b5825947e4ac06976e revision: 78b89cc4c3d3f09f73077d02cb6cae7bae0e07c3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:40.444339) ========= master: http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:40.444723) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:40.444990) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:40.482591) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:40.482956) ========= 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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners TMPDIR=/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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-22 10:50:40-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 30.6M=0s 2016-08-22 10:50:40 (30.6 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.381162 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:40.887077) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:40.887399) ========= 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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners TMPDIR=/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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.029804 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:40.936925) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-22 10:50:40.937237) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 78b89cc4c3d3f09f73077d02cb6cae7bae0e07c3 --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 78b89cc4c3d3f09f73077d02cb6cae7bae0e07c3 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.DD09b5bCOW/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.pnzdDMa6IJ/Listeners TMPDIR=/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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-22 10:50:41,009 truncating revision to first 12 chars 2016-08-22 10:50:41,009 Setting DEBUG logging. 2016-08-22 10:50:41,009 attempt 1/10 2016-08-22 10:50:41,009 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/78b89cc4c3d3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-22 10:50:42,103 unpacking tar archive at: mozilla-central-78b89cc4c3d3/testing/mozharness/ program finished with exit code 0 elapsedTime=1.340856 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-22 10:50:42.298965) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:42.299244) ========= script_repo_revision: 78b89cc4c3d3f09f73077d02cb6cae7bae0e07c3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-22 10:50:42.299600) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 3 secs) (at 2016-08-22 10:50:42.299874) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 3 secs) (at 2016-08-22 10:50:45.848111) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 12 secs) (at 2016-08-22 10:50:45.848427) ========= /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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners TMPDIR=/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:50:46 INFO - MultiFileLogger online at 20160822 10:50:46 in /builds/slave/test 10:50:46 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 10:50:46 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:50:46 INFO - {'append_to_log': False, 10:50:46 INFO - 'base_work_dir': '/builds/slave/test', 10:50:46 INFO - 'blob_upload_branch': 'Firefox', 10:50:46 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:50:46 INFO - 'branch': 'Firefox', 10:50:46 INFO - 'buildbot_json_path': 'buildprops.json', 10:50:46 INFO - 'config_files': ('talos/mac_config.py',), 10:50:46 INFO - 'default_actions': ('clobber', 10:50:46 INFO - 'read-buildbot-config', 10:50:46 INFO - 'download-and-extract', 10:50:46 INFO - 'populate-webroot', 10:50:46 INFO - 'create-virtualenv', 10:50:46 INFO - 'install', 10:50:46 INFO - 'run-tests'), 10:50:46 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:50:46 INFO - 'download_minidump_stackwalk': True, 10:50:46 INFO - 'download_symbols': 'ondemand', 10:50:46 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:50:46 INFO - 'tooltool.py': '/tools/tooltool.py', 10:50:46 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:50:46 INFO - '/tools/misc-python/virtualenv.py')}, 10:50:46 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:50:46 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:50:46 INFO - 'installer_path': 'installer.exe', 10:50:46 INFO - 'log_level': 'info', 10:50:46 INFO - 'log_name': 'talos', 10:50:46 INFO - 'log_to_console': True, 10:50:46 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 10:50:46 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 10:50:46 INFO - 'opt_config_files': (), 10:50:46 INFO - 'pip_index': False, 10:50:46 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:50:46 INFO - 'cmd': ('bash', 10:50:46 INFO - '-c', 10:50:46 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:50:46 INFO - 'enabled': True, 10:50:46 INFO - 'halt_on_failure': False, 10:50:46 INFO - 'name': 'check_screen_resolution'},), 10:50:46 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:50:46 INFO - 'cmd': ('bash', 10:50:46 INFO - '-c', 10:50:46 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:50:46 INFO - 'enabled': True, 10:50:46 INFO - 'halt_on_failure': False, 10:50:46 INFO - 'name': 'check_screen_resolution'},), 10:50:46 INFO - 'run_cmd_checks_enabled': True, 10:50:46 INFO - 'sps_profile': False, 10:50:46 INFO - 'sps_profile_interval': 0, 10:50:46 INFO - 'suite': 'dromaeojs-e10s', 10:50:46 INFO - 'system_bits': '32', 10:50:46 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:50:46 INFO - 'title': 't-yosemite-r7-0199', 10:50:46 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:50:46 INFO - 'use_talos_json': True, 10:50:46 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:50:46 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:50:46 INFO - 'work_dir': 'build'} 10:50:46 INFO - [mozharness: 2016-08-22 17:50:46.045957Z] Running clobber step. 10:50:46 INFO - Running pre-action listener: _resource_record_pre_action 10:50:46 INFO - Running main action method: clobber 10:50:46 INFO - rmtree: /builds/slave/test/build 10:50:46 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:50:48 INFO - Running post-action listener: _resource_record_post_action 10:50:48 INFO - [mozharness: 2016-08-22 17:50:48.167928Z] Finished clobber step (success) 10:50:48 INFO - [mozharness: 2016-08-22 17:50:48.168061Z] Running read-buildbot-config step. 10:50:48 INFO - Running pre-action listener: _resource_record_pre_action 10:50:48 INFO - Running main action method: read_buildbot_config 10:50:48 INFO - Using buildbot properties: 10:50:48 INFO - { 10:50:48 INFO - "project": "", 10:50:48 INFO - "product": "firefox", 10:50:48 INFO - "script_repo_revision": "production", 10:50:48 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs-e10s", 10:50:48 INFO - "repository": "", 10:50:48 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs-e10s", 10:50:48 INFO - "buildid": "20160822082914", 10:50:48 INFO - "pgo_build": "False", 10:50:48 INFO - "basedir": "/builds/slave/test", 10:50:48 INFO - "buildnumber": 46, 10:50:48 INFO - "slavename": "t-yosemite-r7-0199", 10:50:48 INFO - "master": "http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/", 10:50:48 INFO - "platform": "yosemite_r7", 10:50:48 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 10:50:48 INFO - "branch": "mozilla-central", 10:50:48 INFO - "repo_path": "mozilla-central", 10:50:48 INFO - "revision": "78b89cc4c3d3f09f73077d02cb6cae7bae0e07c3", 10:50:48 INFO - "stage_platform": "macosx64", 10:50:48 INFO - "builduid": "830706a6bcc241b5825947e4ac06976e", 10:50:48 INFO - "slavebuilddir": "test" 10:50:48 INFO - } 10:50:48 INFO - Found installer url https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg. 10:50:48 INFO - Running post-action listener: _resource_record_post_action 10:50:48 INFO - [mozharness: 2016-08-22 17:50:48.171445Z] Finished read-buildbot-config step (success) 10:50:48 INFO - [mozharness: 2016-08-22 17:50:48.171578Z] Running download-and-extract step. 10:50:48 INFO - Running pre-action listener: _resource_record_pre_action 10:50:48 INFO - Running main action method: download_and_extract 10:50:48 INFO - mkdir: /builds/slave/test/build/tests 10:50:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:50:48 INFO - trying https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json 10:50:48 INFO - Downloading https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:50:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:50:49 INFO - Downloaded 1199 bytes. 10:50:49 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 10:50:49 INFO - Using the following test package requirements: 10:50:49 INFO - {u'common': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 10:50:49 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 10:50:49 INFO - u'firefox-51.0a1.en-US.mac.cppunittest.tests.zip'], 10:50:49 INFO - u'gtest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 10:50:49 INFO - u'firefox-51.0a1.en-US.mac.gtest.tests.zip'], 10:50:49 INFO - u'jittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 10:50:49 INFO - u'jsshell-mac.zip'], 10:50:49 INFO - u'mochitest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 10:50:49 INFO - u'firefox-51.0a1.en-US.mac.mochitest.tests.zip'], 10:50:49 INFO - u'mozbase': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 10:50:49 INFO - u'reftest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 10:50:49 INFO - u'firefox-51.0a1.en-US.mac.reftest.tests.zip'], 10:50:49 INFO - u'talos': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 10:50:49 INFO - u'firefox-51.0a1.en-US.mac.talos.tests.zip'], 10:50:49 INFO - u'web-platform': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 10:50:49 INFO - u'firefox-51.0a1.en-US.mac.web-platform.tests.zip'], 10:50:49 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 10:50:49 INFO - u'firefox-51.0a1.en-US.mac.xpcshell.tests.zip']} 10:50:49 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip'] for test suite category: common 10:50:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:50:49 INFO - trying https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 10:50:49 INFO - Downloading https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:50:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:50:50 INFO - Downloaded 16352465 bytes. 10:50:50 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 10:50:57 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 10:50:57 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')]} 10:50:57 INFO - trying https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 10:50:57 INFO - Downloading https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:50:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:50:59 INFO - Downloaded 16352465 bytes. 10:50:59 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 10:51:05 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')]} 10:51:05 INFO - trying https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip 10:51:05 INFO - Downloading https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:51:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:51:06 INFO - Downloaded 14413981 bytes. 10:51:06 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/tests 10:51:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:07 INFO - trying https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 10:51:07 INFO - Downloading https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg 10:51:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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 10:51:10 INFO - Downloaded 111487373 bytes. 10:51:10 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 10:51:10 INFO - mkdir: /builds/slave/test/properties 10:51:10 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:51:10 INFO - Writing to file /builds/slave/test/properties/build_url 10:51:10 INFO - Contents: 10:51:10 INFO - build_url:https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 10:51:10 INFO - Running post-action listener: _resource_record_post_action 10:51:10 INFO - Running post-action listener: set_extra_try_arguments 10:51:10 INFO - [mozharness: 2016-08-22 17:51:10.735634Z] Finished download-and-extract step (success) 10:51:10 INFO - [mozharness: 2016-08-22 17:51:10.735769Z] Running populate-webroot step. 10:51:10 INFO - Running pre-action listener: _resource_record_pre_action 10:51:10 INFO - Running main action method: populate_webroot 10:51:10 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:51:10 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:51:10 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:51:10 INFO - '--tppagecycles', 10:51:10 INFO - '7'], 10:51:10 INFO - 'tests': ['tsvgm']}}, 10:51:10 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:51:10 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:51:10 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:51:10 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:51:10 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:51:10 INFO - 'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:51:10 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:51:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:51:10 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:51:10 INFO - 'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['damp', 'tps']}, 10:51:10 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:51:10 INFO - 'tests': ['damp', 'tps']}, 10:51:10 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['dromaeo_dom']}, 10:51:10 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:51:10 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['basic_compositor_video']}, 10:51:10 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:51:10 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['a11yr', 10:51:10 INFO - 'ts_paint', 10:51:10 INFO - 'tpaint', 10:51:10 INFO - 'sessionrestore', 10:51:10 INFO - 'sessionrestore_no_auto_restore', 10:51:10 INFO - 'tabpaint']}, 10:51:10 INFO - 'other-e10s': {'tests': ['a11yr', 10:51:10 INFO - 'ts_paint', 10:51:10 INFO - 'tpaint', 10:51:10 INFO - 'sessionrestore', 10:51:10 INFO - 'sessionrestore_no_auto_restore', 10:51:10 INFO - 'tabpaint']}, 10:51:10 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:51:10 INFO - 'ts_paint', 10:51:10 INFO - 'tpaint', 10:51:10 INFO - 'sessionrestore', 10:51:10 INFO - 'sessionrestore_no_auto_restore', 10:51:10 INFO - 'tabpaint']}, 10:51:10 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:51:10 INFO - 'ts_paint', 10:51:10 INFO - 'tpaint', 10:51:10 INFO - 'sessionrestore', 10:51:10 INFO - 'sessionrestore_no_auto_restore', 10:51:10 INFO - 'tabpaint']}, 10:51:10 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['a11yr', 10:51:10 INFO - 'ts_paint', 10:51:10 INFO - 'tpaint', 10:51:10 INFO - 'sessionrestore', 10:51:10 INFO - 'sessionrestore_no_auto_restore', 10:51:10 INFO - 'tabpaint']}, 10:51:10 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['a11yr', 10:51:10 INFO - 'ts_paint', 10:51:10 INFO - 'tpaint', 10:51:10 INFO - 'sessionrestore', 10:51:10 INFO - 'sessionrestore_no_auto_restore', 10:51:10 INFO - 'tabpaint']}, 10:51:10 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['tsvgx', 10:51:10 INFO - 'tsvgr_opacity', 10:51:10 INFO - 'tart', 10:51:10 INFO - 'tscrollx', 10:51:10 INFO - 'cart']}, 10:51:10 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:51:10 INFO - 'tsvgr_opacity', 10:51:10 INFO - 'tart', 10:51:10 INFO - 'tscrollx', 10:51:10 INFO - 'cart']}, 10:51:10 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:51:10 INFO - 'talos_options': ['--disable-e10s'], 10:51:10 INFO - 'tests': ['tp5o']}, 10:51:10 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:51:10 INFO - 'tests': ['tp5o']}, 10:51:10 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:51:10 INFO - 'talos_options': ['--disable-e10s', 10:51:10 INFO - '--xperf_path', 10:51:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:51:10 INFO - 'tests': ['tp5n']}, 10:51:10 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:51:10 INFO - 'talos_options': ['--xperf_path', 10:51:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:51:10 INFO - 'tests': ['tp5n']}}, 10:51:10 INFO - 'talos.zip': {'path': '', 10:51:10 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:51:10 INFO - Running post-action listener: _resource_record_post_action 10:51:10 INFO - [mozharness: 2016-08-22 17:51:10.754581Z] Finished populate-webroot step (success) 10:51:10 INFO - [mozharness: 2016-08-22 17:51:10.754701Z] Running create-virtualenv step. 10:51:10 INFO - Running pre-action listener: _resource_record_pre_action 10:51:10 INFO - Running main action method: create_virtualenv 10:51:10 INFO - Creating virtualenv /builds/slave/test/build/venv 10:51:10 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 10:51:10 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:51:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:51:10 INFO - Using real prefix '/tools/python27' 10:51:10 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:51:11 INFO - Installing distribute.............................................................................................................................................................................................done. 10:51:14 INFO - Installing pip.................done. 10:51:14 INFO - Return code: 0 10:51:14 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:51:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 10:51:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 10:51:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:14 INFO - 'HOME': '/Users/cltbld', 10:51:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:14 INFO - 'LOGNAME': 'cltbld', 10:51:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:14 INFO - 'MOZ_NO_REMOTE': '1', 10:51:14 INFO - 'NO_EM_RESTART': '1', 10:51:14 INFO - 'PAGER': '/bin/cat', 10:51:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:14 INFO - 'PWD': '/builds/slave/test', 10:51:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:14 INFO - 'SHELL': '/bin/bash', 10:51:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:14 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:14 INFO - 'USER': 'cltbld', 10:51:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:14 INFO - 'XPC_FLAGS': '0x0', 10:51:14 INFO - 'XPC_SERVICE_NAME': '0', 10:51:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:14 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 10:51:14 INFO - Cleaning up... 10:51:14 INFO - Return code: 0 10:51:14 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:51:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 10:51:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 10:51:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:14 INFO - 'HOME': '/Users/cltbld', 10:51:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:14 INFO - 'LOGNAME': 'cltbld', 10:51:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:14 INFO - 'MOZ_NO_REMOTE': '1', 10:51:14 INFO - 'NO_EM_RESTART': '1', 10:51:14 INFO - 'PAGER': '/bin/cat', 10:51:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:14 INFO - 'PWD': '/builds/slave/test', 10:51:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:14 INFO - 'SHELL': '/bin/bash', 10:51:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:14 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:14 INFO - 'USER': 'cltbld', 10:51:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:14 INFO - 'XPC_FLAGS': '0x0', 10:51:14 INFO - 'XPC_SERVICE_NAME': '0', 10:51:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:14 INFO - Downloading/unpacking psutil>=3.1.1 10:51:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:51:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:51:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:51:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:51:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:51:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:51:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:51:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:51:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:51:17 INFO - Installing collected packages: psutil 10:51:17 INFO - Running setup.py install for psutil 10:51:18 INFO - building 'psutil._psutil_osx' extension 10:51:18 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 10:51:18 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 10:51:18 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 10:51:18 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 10:51:18 INFO - building 'psutil._psutil_posix' extension 10:51:18 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 10:51:18 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 10:51:18 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 10:51:18 INFO - ^ 10:51:19 INFO - 1 warning generated. 10:51:19 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 10:51:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:51:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:51:19 INFO - Successfully installed psutil 10:51:19 INFO - Cleaning up... 10:51:19 INFO - Return code: 0 10:51:19 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:51:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 10:51:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 10:51:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:19 INFO - 'HOME': '/Users/cltbld', 10:51:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:19 INFO - 'LOGNAME': 'cltbld', 10:51:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:19 INFO - 'MOZ_NO_REMOTE': '1', 10:51:19 INFO - 'NO_EM_RESTART': '1', 10:51:19 INFO - 'PAGER': '/bin/cat', 10:51:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:19 INFO - 'PWD': '/builds/slave/test', 10:51:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:19 INFO - 'SHELL': '/bin/bash', 10:51:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:19 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:19 INFO - 'USER': 'cltbld', 10:51:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:19 INFO - 'XPC_FLAGS': '0x0', 10:51:19 INFO - 'XPC_SERVICE_NAME': '0', 10:51:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:19 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:51:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:51:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:51:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:51:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:51:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:51:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:51:21 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:51:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:51:21 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:51:21 INFO - Installing collected packages: mozsystemmonitor 10:51:21 INFO - Running setup.py install for mozsystemmonitor 10:51:22 INFO - Successfully installed mozsystemmonitor 10:51:22 INFO - Cleaning up... 10:51:22 INFO - Return code: 0 10:51:22 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:51:22 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')]} 10:51:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:22 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')]} 10:51:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:22 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 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51:22 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 10:51:22 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 10:51:22 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:22 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:22 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:22 INFO - 'HOME': '/Users/cltbld', 10:51:22 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:22 INFO - 'LOGNAME': 'cltbld', 10:51:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:22 INFO - 'MOZ_NO_REMOTE': '1', 10:51:22 INFO - 'NO_EM_RESTART': '1', 10:51:22 INFO - 'PAGER': '/bin/cat', 10:51:22 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:22 INFO - 'PWD': '/builds/slave/test', 10:51:22 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:22 INFO - 'SHELL': '/bin/bash', 10:51:22 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:22 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:22 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:22 INFO - 'USER': 'cltbld', 10:51:22 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:22 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:22 INFO - 'XPC_FLAGS': '0x0', 10:51:22 INFO - 'XPC_SERVICE_NAME': '0', 10:51:22 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:22 INFO - Downloading/unpacking jsonschema==2.5.1 10:51:22 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 10:51:22 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 10:51:22 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 10:51:22 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 10:51:22 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 10:51:22 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 10:51:24 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:51:24 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:51:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:51:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:51:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:51:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:51:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:51:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:51:25 INFO - Downloading functools32-3.2.3-2.tar.gz 10:51:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:51:25 INFO - warning: no files found matching '*.txt' 10:51:25 INFO - no previously-included directories found matching 'build' 10:51:25 INFO - no previously-included directories found matching 'dist' 10:51:25 INFO - no previously-included directories found matching '.git*' 10:51:25 INFO - Installing collected packages: jsonschema, functools32 10:51:25 INFO - Running setup.py install for functools32 10:51:25 INFO - warning: no files found matching '*.txt' 10:51:25 INFO - no previously-included directories found matching 'build' 10:51:25 INFO - no previously-included directories found matching 'dist' 10:51:25 INFO - no previously-included directories found matching '.git*' 10:51:25 INFO - Successfully installed jsonschema functools32 10:51:25 INFO - Cleaning up... 10:51:25 INFO - Return code: 0 10:51:25 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 10:51:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 10:51:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 10:51:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:25 INFO - 'HOME': '/Users/cltbld', 10:51:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:25 INFO - 'LOGNAME': 'cltbld', 10:51:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:25 INFO - 'MOZ_NO_REMOTE': '1', 10:51:25 INFO - 'NO_EM_RESTART': '1', 10:51:25 INFO - 'PAGER': '/bin/cat', 10:51:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:25 INFO - 'PWD': '/builds/slave/test', 10:51:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:25 INFO - 'SHELL': '/bin/bash', 10:51:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:25 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:25 INFO - 'USER': 'cltbld', 10:51:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:25 INFO - 'XPC_FLAGS': '0x0', 10:51:25 INFO - 'XPC_SERVICE_NAME': '0', 10:51:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:25 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 10:51:25 INFO - Cleaning up... 10:51:25 INFO - Return code: 0 10:51:25 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:51:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51: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', '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 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:51: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 blobuploader==1.2.4 10:51:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:26 INFO - 'HOME': '/Users/cltbld', 10:51:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:26 INFO - 'LOGNAME': 'cltbld', 10:51:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:26 INFO - 'MOZ_NO_REMOTE': '1', 10:51:26 INFO - 'NO_EM_RESTART': '1', 10:51:26 INFO - 'PAGER': '/bin/cat', 10:51:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:26 INFO - 'PWD': '/builds/slave/test', 10:51:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:26 INFO - 'SHELL': '/bin/bash', 10:51:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:26 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:26 INFO - 'USER': 'cltbld', 10:51:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:26 INFO - 'XPC_FLAGS': '0x0', 10:51:26 INFO - 'XPC_SERVICE_NAME': '0', 10:51:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:26 INFO - Downloading/unpacking blobuploader==1.2.4 10:51: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 10:51: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 10:51: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 10:51: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 10:51: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 10:51: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 10:51:28 INFO - Downloading blobuploader-1.2.4.tar.gz 10:51:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:51:28 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:51:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:51:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:51:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:51:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:51:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:51:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:51:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:51:29 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:51: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 10:51: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 10:51: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 10:51: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 10:51: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 10:51: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 10:51:29 INFO - Downloading docopt-0.6.1.tar.gz 10:51:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:51:30 INFO - Installing collected packages: blobuploader, requests, docopt 10:51:30 INFO - Running setup.py install for blobuploader 10:51:30 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:51:30 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:51:30 INFO - Running setup.py install for requests 10:51:30 INFO - Running setup.py install for docopt 10:51:30 INFO - Successfully installed blobuploader requests docopt 10:51:30 INFO - Cleaning up... 10:51:30 INFO - Return code: 0 10:51:30 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:51:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:30 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 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51:30 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 10:51:30 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 10:51:30 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:30 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:30 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:30 INFO - 'HOME': '/Users/cltbld', 10:51:30 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:30 INFO - 'LOGNAME': 'cltbld', 10:51:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:30 INFO - 'MOZ_NO_REMOTE': '1', 10:51:30 INFO - 'NO_EM_RESTART': '1', 10:51:30 INFO - 'PAGER': '/bin/cat', 10:51:30 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:30 INFO - 'PWD': '/builds/slave/test', 10:51:30 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:30 INFO - 'SHELL': '/bin/bash', 10:51:30 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:30 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:30 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:30 INFO - 'USER': 'cltbld', 10:51:30 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:30 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:30 INFO - 'XPC_FLAGS': '0x0', 10:51:30 INFO - 'XPC_SERVICE_NAME': '0', 10:51:30 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-RvxqJw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-gOS9WK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-QNLFqA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-6oqnnB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-IzyHUm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-Ub8cjc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-q77IQn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-ZF7gqY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:51:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:51:31 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-_LwGLX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:51:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:51:32 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-V1vO1j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:51:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:51:32 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-ciaQ0t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:51:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:51:32 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-0BEKss-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:51:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:51:32 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-CRcCmB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:51:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:51:32 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-X2WKhV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:51:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:51:32 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-32pJz4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:51:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:51:32 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-ChLJoK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:51:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:51:32 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-OTnEda-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:51:32 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:51:32 INFO - Running setup.py install for manifestparser 10:51:33 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:51:33 INFO - Running setup.py install for mozcrash 10:51:33 INFO - Running setup.py install for mozdebug 10:51:33 INFO - Running setup.py install for mozdevice 10:51:33 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:51:33 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:51:33 INFO - Running setup.py install for mozfile 10:51:33 INFO - Running setup.py install for mozhttpd 10:51:33 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:51:33 INFO - Running setup.py install for mozinfo 10:51:33 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:51:33 INFO - Running setup.py install for mozInstall 10:51:34 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Running setup.py install for mozleak 10:51:34 INFO - Running setup.py install for mozlog 10:51:34 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Running setup.py install for moznetwork 10:51:34 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Running setup.py install for mozprocess 10:51:34 INFO - Running setup.py install for mozprofile 10:51:34 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:51:34 INFO - Running setup.py install for mozrunner 10:51:34 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:51:35 INFO - Running setup.py install for mozscreenshot 10:51:35 INFO - Running setup.py install for moztest 10:51:35 INFO - Running setup.py install for mozversion 10:51:35 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:51:35 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:51:35 INFO - Cleaning up... 10:51:35 INFO - Return code: 0 10:51:35 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:51:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:35 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 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51:35 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 10:51:35 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 10:51:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:35 INFO - 'HOME': '/Users/cltbld', 10:51:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:35 INFO - 'LOGNAME': 'cltbld', 10:51:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:35 INFO - 'MOZ_NO_REMOTE': '1', 10:51:35 INFO - 'NO_EM_RESTART': '1', 10:51:35 INFO - 'PAGER': '/bin/cat', 10:51:35 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:35 INFO - 'PWD': '/builds/slave/test', 10:51:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:35 INFO - 'SHELL': '/bin/bash', 10:51:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:35 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:35 INFO - 'USER': 'cltbld', 10:51:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:35 INFO - 'XPC_FLAGS': '0x0', 10:51:35 INFO - 'XPC_SERVICE_NAME': '0', 10:51:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-atU6_0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:51:36 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-l0ZI9U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:51:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-wi_KfP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:51:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-s0B0pN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:51:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-pWAuNZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:51:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-UzTPt_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:51:36 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)) 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-3uhPjN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:51:36 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)) 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-XJzyY7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:51:36 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)) 10:51:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:51:36 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-AMdNb6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:51: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)) 10:51:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:51:37 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-gqHJMo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:51: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)) 10:51:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:51:37 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-vVIqwu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:51:37 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 10:51:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:51:37 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-9XjPwI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:51:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 10:51:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:51:37 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-oSPna7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:51:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 10:51:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:51:37 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-1ZGJQj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:51:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 10:51:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:51:37 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-TDaEv1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:51:37 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)) 10:51:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:51:37 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-GryzhE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:51:37 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)) 10:51:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:51:37 INFO - Running setup.py (path:/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/pip-n9hJMM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:51:37 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)) 10:51:37 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)) 10:51:37 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)) 10:51:37 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)) 10:51:37 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)) 10:51:37 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)) 10:51:37 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:51:37 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 10:51:37 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 10:51:37 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 10:51:37 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 10:51:37 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 10:51:37 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 10:51:40 INFO - Downloading blessings-1.6.tar.gz 10:51:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:51:40 INFO - Installing collected packages: blessings 10:51:40 INFO - Running setup.py install for blessings 10:51:41 INFO - Successfully installed blessings 10:51:41 INFO - Cleaning up... 10:51:41 INFO - Return code: 0 10:51:41 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:51:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:51:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:51:41 INFO - Reading from file tmpfile_stdout 10:51:41 INFO - Current package versions: 10:51:41 INFO - blessings == 1.6 10:51:41 INFO - blobuploader == 1.2.4 10:51:41 INFO - docopt == 0.6.1 10:51:41 INFO - functools32 == 3.2.3-2 10:51:41 INFO - jsonschema == 2.5.1 10:51:41 INFO - manifestparser == 1.1 10:51:41 INFO - mozInstall == 1.12 10:51:41 INFO - mozcrash == 0.17 10:51:41 INFO - mozdebug == 0.1 10:51:41 INFO - mozdevice == 0.48 10:51:41 INFO - mozfile == 1.2 10:51:41 INFO - mozhttpd == 0.7 10:51:41 INFO - mozinfo == 0.9 10:51:41 INFO - mozleak == 0.1 10:51:41 INFO - mozlog == 3.3 10:51:41 INFO - moznetwork == 0.27 10:51:41 INFO - mozprocess == 0.23 10:51:41 INFO - mozprofile == 0.28 10:51:41 INFO - mozrunner == 6.12 10:51:41 INFO - mozscreenshot == 0.1 10:51:41 INFO - mozsystemmonitor == 0.3 10:51:41 INFO - moztest == 0.7 10:51:41 INFO - mozversion == 1.4 10:51:41 INFO - psutil == 3.1.1 10:51:41 INFO - requests == 1.2.3 10:51:41 INFO - wsgiref == 0.1.2 10:51:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:51:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51: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 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51: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 10:51: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 10:51:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:41 INFO - 'HOME': '/Users/cltbld', 10:51:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:41 INFO - 'LOGNAME': 'cltbld', 10:51:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:41 INFO - 'MOZ_NO_REMOTE': '1', 10:51:41 INFO - 'NO_EM_RESTART': '1', 10:51:41 INFO - 'PAGER': '/bin/cat', 10:51:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:41 INFO - 'PWD': '/builds/slave/test', 10:51:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:41 INFO - 'SHELL': '/bin/bash', 10:51:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:41 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:41 INFO - 'USER': 'cltbld', 10:51:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:41 INFO - 'XPC_FLAGS': '0x0', 10:51:41 INFO - 'XPC_SERVICE_NAME': '0', 10:51:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:51:41 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:51:41 INFO - Cleaning up... 10:51:41 INFO - Return code: 0 10:51:41 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:51:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:51:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:51:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:51:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:51:41 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10b0d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b168618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9fa2c704e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, '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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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 10:51:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 10:51:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 10:51:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:51:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:51:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:51:41 INFO - 'HOME': '/Users/cltbld', 10:51:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:51:41 INFO - 'LOGNAME': 'cltbld', 10:51:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:51:41 INFO - 'MOZ_NO_REMOTE': '1', 10:51:41 INFO - 'NO_EM_RESTART': '1', 10:51:41 INFO - 'PAGER': '/bin/cat', 10:51:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:51:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:51:41 INFO - 'PWD': '/builds/slave/test', 10:51:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:51:41 INFO - 'SHELL': '/bin/bash', 10:51:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:51:41 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:51:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:51:41 INFO - 'USER': 'cltbld', 10:51:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:51:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:51:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:51:41 INFO - 'XPC_FLAGS': '0x0', 10:51:41 INFO - 'XPC_SERVICE_NAME': '0', 10:51:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:51:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:51:42 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:51:42 INFO - Cleaning up... 10:51:42 INFO - Return code: 0 10:51:42 INFO - Running post-action listener: _resource_record_post_action 10:51:42 INFO - Running post-action listener: _start_resource_monitoring 10:51:42 INFO - Starting resource monitoring. 10:51:42 INFO - [mozharness: 2016-08-22 17:51:42.089108Z] Finished create-virtualenv step (success) 10:51:42 INFO - [mozharness: 2016-08-22 17:51:42.090134Z] Running install step. 10:51:42 INFO - Running pre-action listener: _resource_record_pre_action 10:51:42 INFO - Running main action method: install 10:51:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:51:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:51:42 INFO - Reading from file tmpfile_stdout 10:51:42 INFO - Detecting whether we're running mozinstall >=1.0... 10:51:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:51:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:51:42 INFO - Reading from file tmpfile_stdout 10:51:42 INFO - Output received: 10:51:42 INFO - Usage: mozinstall [options] installer 10:51:42 INFO - Options: 10:51:42 INFO - -h, --help show this help message and exit 10:51:42 INFO - -d DEST, --destination=DEST 10:51:42 INFO - Directory to install application into. [default: 10:51:42 INFO - "/builds/slave/test"] 10:51:42 INFO - --app=APP Application being installed. [default: firefox] 10:51:42 INFO - mkdir: /builds/slave/test/build/application 10:51: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'] 10:51: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 10:52:16 INFO - Reading from file tmpfile_stdout 10:52:16 INFO - Output received: 10:52:16 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 10:52:16 INFO - Running post-action listener: _resource_record_post_action 10:52:16 INFO - [mozharness: 2016-08-22 17:52:16.540222Z] Finished install step (success) 10:52:16 INFO - [mozharness: 2016-08-22 17:52:16.540355Z] Running run-tests step. 10:52:16 INFO - Running pre-action listener: _resource_record_pre_action 10:52:16 INFO - Running main action method: run_tests 10:52:16 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:52:16 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:52:16 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:52:16 INFO - 2016-08-22 10:52:16.552 screenresolution[1637:7615] starting screenresolution argv=screenresolution get 10:52:16 INFO - 2016-08-22 10:52:16.555 screenresolution[1637:7615] Display 0: 1600x1200x32@60 10:52:16 INFO - 2016-08-22 10:52:16.560 screenresolution[1638:7617] starting screenresolution argv=screenresolution list 10:52:16 INFO - Available Modes on Display 0 10:52:16 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:52:16 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:52:16 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:52:16 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:52:16 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:52:16 INFO - Intel Iris: 10:52:16 INFO - Chipset Model: Intel Iris 10:52:16 INFO - Type: GPU 10:52:16 INFO - Bus: Built-In 10:52:16 INFO - VRAM (Dynamic, Max): 1536 MB 10:52:16 INFO - Vendor: Intel (0x8086) 10:52:16 INFO - Device ID: 0x0a2e 10:52:16 INFO - Revision ID: 0x0009 10:52:16 INFO - Displays: 10:52:16 INFO - Display: 10:52:16 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:52:16 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:52:16 INFO - Display Serial Number: 1600x1200 60 10:52:16 INFO - Main Display: Yes 10:52:16 INFO - Mirror: Off 10:52:16 INFO - Online: Yes 10:52:16 INFO - Rotation: Supported 10:52:16 INFO - Return code: 0 10:52:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:52:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:52:16 INFO - Python 2.7.3 10:52:16 INFO - Return code: 0 10:52:16 INFO - grabbing minidump binary from tooltool 10:52:16 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')]} 10:52:16 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 0x10b037d30>, '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 0x10ad9cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10b02fb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:52:16 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 10:52:16 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 10:52:16 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 10:52:16 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:52:16 INFO - Return code: 0 10:52:16 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 10:52:16 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:52:16 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:52:16 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 10:52:16 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:52:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0199', '--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 10:52:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0199 --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 10:52:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DD09b5bCOW/Render', 10:52:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:52:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:52:16 INFO - 'HOME': '/Users/cltbld', 10:52:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:52:16 INFO - 'LOGNAME': 'cltbld', 10:52:16 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:52:16 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 10:52:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:52:16 INFO - 'MOZ_NO_REMOTE': '1', 10:52:16 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:52:16 INFO - 'NO_EM_RESTART': '1', 10:52:16 INFO - 'PAGER': '/bin/cat', 10:52:16 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:52:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:52:16 INFO - 'PWD': '/builds/slave/test', 10:52:16 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:52:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:52:16 INFO - 'SHELL': '/bin/bash', 10:52:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.pnzdDMa6IJ/Listeners', 10:52:16 INFO - 'TMPDIR': '/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/', 10:52:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:52:16 INFO - 'USER': 'cltbld', 10:52:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:52:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:52:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:52:16 INFO - 'XPC_FLAGS': '0x0', 10:52:16 INFO - 'XPC_SERVICE_NAME': '0', 10:52:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:52:16 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0199', '--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 10:52:17 INFO - mozversion application_buildid: 20160822082914 10:52:17 INFO - mozversion application_changeset: 78b89cc4c3d3f09f73077d02cb6cae7bae0e07c3 10:52:17 INFO - mozversion application_display_name: Nightly 10:52:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:52:17 INFO - mozversion application_name: Firefox 10:52:17 INFO - mozversion application_remotingname: firefox 10:52:17 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 10:52:17 INFO - mozversion application_vendor: Mozilla 10:52:17 INFO - mozversion application_version: 51.0a1 10:52:17 INFO - mozversion platform_buildid: 20160822082914 10:52:17 INFO - mozversion platform_changeset: 78b89cc4c3d3f09f73077d02cb6cae7bae0e07c3 10:52:17 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 10:52:17 INFO - mozversion platform_version: 51.0a1 10:52:17 INFO - using testdate: 1471888337 10:52:17 INFO - actual date: 1471888337 10:52:17 INFO - starting webserver on 'localhost:49270' 10:52:17 INFO - SUITE-START | Running 2 tests 10:52:17 INFO - TEST-START | dromaeo_css 10:52:17 INFO - operating with platform_type : mac_ 10:52:17 INFO - Initialising browser for dromaeo_css test... 10:52:17 INFO - TEST-INFO | started process 1648 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/tmpeZZfM7/profile http://localhost:49270/getInfo.html) 10:52:19 INFO - PROCESS | 1648 | __metrics Screen width/height:1600/1200 10:52:19 INFO - PROCESS | 1648 | colorDepth:24 10:52:19 INFO - PROCESS | 1648 | Browser inner width/height: 1024/689 10:52:19 INFO - PROCESS | 1648 | __metrics 10:52:19 ERROR - PROCESS | 1648 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2993: TypeError: this.tabs is undefined 10:52:20 INFO - TEST-INFO | 1648: exit 0 10:52:20 INFO - Browser initialized. 10:52:20 INFO - Running cycle 1/1 for dromaeo_css test... 10:52:20 INFO - TEST-INFO | started process 1651 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/tmpeZZfM7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:52:32 INFO - PROCESS | 1651 | RSS: Main: 239923200 10:52:32 INFO - PROCESS | 1651 | 10:53:22 INFO - PROCESS | 1651 | 1471888402448 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] 10:55:34 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49270/tests/dromaeo/cssquery-ext.html) 10:55:36 INFO - PROCESS | 1651 | RSS: Main: 255414272 10:55:36 INFO - PROCESS | 1651 | 10:58:38 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-ext.html (next: http://localhost:49270/tests/dromaeo/cssquery-jquery.html) 10:58:39 INFO - PROCESS | 1651 | RSS: Main: 267157504 10:58:39 INFO - PROCESS | 1651 | 11:01:40 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49270/tests/dromaeo/cssquery-mootools.html) 11:01:41 INFO - PROCESS | 1651 | RSS: Main: 272928768 11:01:41 INFO - PROCESS | 1651 | 11:04:43 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49270/tests/dromaeo/cssquery-prototype.html) 11:04:44 INFO - PROCESS | 1651 | RSS: Main: 272330752 11:04:44 INFO - PROCESS | 1651 | 11:07:46 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49270/tests/dromaeo/cssquery-yui.html) 11:07:47 INFO - PROCESS | 1651 | RSS: Main: 278568960 11:07:47 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-yui.html (next: http://localhost:49270/tests/dromaeo/cssquery-dojo.html) 11:10:50 INFO - PROCESS | 1651 | RSS: Main: 281276416 11:10:50 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | __start_tp_report 11:10:50 INFO - PROCESS | 1651 | _x_x_mozilla_page_load 11:10:50 INFO - PROCESS | 1651 | _x_x_mozilla_page_load_details 11:10:50 INFO - PROCESS | 1651 | |i|pagename|runs| 11:10:50 INFO - PROCESS | 1651 | |0;dojo.html;2872.569114632805;3440.9483857742134;3461.4115600347936;3466.774659647121;3479.6520347965206;4608.124456353291;5456.781728730846;5730.398308177644;5754.878158438993;5809.651420914743;5746.597738158331;5764.193012978176;5766.394528574502;5797.898399304129;5809.854753631162;5288.391834938983;5320.893582128355;5376;5406.405295417501;5427.592930530206;5153.484651534835;5186.818461353853;5253.133233016548;5335.386430560497;5345.930813837229;4427.760227136407;5299;5304.867378315573;5306.973465132688;5320.122179840322;5319.946800532022;5324.068288049614;5328.5470734987575;5336.893262134774;5337.786488540453;5110.923336149961;5165.431802501722;5251.054810134175;5270.578353731692;5282.128448805943;5761;5816.272965879265;5817.7091145442555;5848.181254624356;5851.678157701324;6231.501479881644;6264.123022776769;6291.8741625167695;6296.559240853142;6304.27500837405;6186.257649082139;6191.597546159485;6238.906416403712;6306.873862522724;6329.1772069631115;5955.583109182359;5959.404059594006;5982.282126144803;6010.248718910137;6012.158297838349;6394.360563943568;6419.293877673452;6454.128692626436;6468.417842394207;6468.741250349934;6112.938870611326;6146.907796383058;6172.259328880473;6277.811665650038;6296.5277604178955;6267.0286105653695;6273.37266273369;6313.747450101944;6314.336994615499;6322.683865806691;6229.314775374705;6254.843628909222;6284.088807122942;6296.433321001132;6304.621722696653;6148.200733904564;6167.444929956326;6203.534734894901;6272.968635156886;6283.5287353448675;4806.206975848946;5031.295618613397;5031.496850315012;5046.621503387188;5049.495050494921;4461.442319710036;4470.173017991617;4503.932441013388;4509.6392288616835;4524.705894116872;4892.706437613754;5759.769609215668;5882.941170588325;5884.529237660977;6040.335563088057;6336.52476064297;6339.841503962346;6340.461060809883;6349.206349206349;6366.490680745529;5995.5803093783015;5999.5800293979;6037.63774173551;6078.057901025348;6099;4742.73914934675;5366.275552800322;5371.543418809445;5512.007838589093;5557.194206840067;5040.79836806531;5404.891902162013;6271.686415679289;6564.901526477202;6589.703463344065;6337.334579869232;6342.651154186379;6350.872457726713;6357.618542887441;6371.458426033653;4967.279744437109;6253.530985176039;6408.61548307103;6559.442447392025;6564.9671751640935;6180.412860778219;6247.3440288769025;6262.4990000800735;6269.216347956505;6274.592151510137;5222.6083043771105;5515.669059856422;6027;6283.49732021428;6296.370362963667;5264.446743329559;5505.568552176383;5899;6075.392460753889;6179.598326108789;6192.411720886508;6242.28213755424;6248.531360148098;6250.4374606285655;6279.403456671609;5030;5409.78360865561;5846.152307915413;6103.115048318058;6141.785037523665;5110.821121260738;6039.396060393926;6101.115338275837;6177.876442471215;6275.74897004133;6102.755889764538;6164.167837341902;6169.629822210682;6173.012318029094;6181.35095814933 11:10:50 INFO - PROCESS | 1651 | |1;ext.html;487.9512048795121;526.778752923772;535.6277387215886;540.2868213957576;560.8794109266512;27699.44601107979;32653.510197347;39340.606593934055;39408.802955985215;39419;33889;40812.59187408125;41465;41479.79260103703;41520.79239603798;9571.425714457137;9719.902800972006;9733.756656083584;9736.318457707928;9756.951215243915;9542.809143817154;9639.180669643089;9665.22678185747;9685.661001864935;9686.031396860293;9649.807003859954;9652.758681032996;9662.275329350292;9681.177099946513;9688.806223875517;9584.04159584043;9593.520323983774;9608.087231712976;9641.710748677586;9670.081342272473;9583.377080489816;9630.9518452408;9673.177779888718;9680.806383872354;9702.75743106428;38758.61241387578;38797.61202387996;38956.610433895585;39185.21629567421;39215.41176882349;3556.6443355664487;3649.872254471081;3667.9266414671556;3987.302222111148;4145.91708165835;25888.74111258882;27913.581296280572;30591.847040764653;31645.84177079123;31731.682683173105;3232.2242661761243;3378.6959173674486;3398.218409765743;3430.091025878144;3430.6054803697643;506346;507203;510603;510897;514875;55050.17424738632;55534.44465555293;55550;55552.72223638937;55560.16659750107;58666.706666466394;59174;59187.40812591819;59219;59294.40705592889;15855;15985.60035999086;15997.520074397788;16077.356905723875;16088.195590220443;12350.691232719075;12424.56514022005;12520.1235913487;12566.81149782754;12567.18313309632;13942.930285348508;15275.541733748005;15306;15341.463048793239;15363.539093827203;2861.6852146263896;3246.172226082334;5440.442882319547;6490.2536208335705;6529.542931994714;689.5381790603851;822.2887202569734;883.306604315622;1011.5751384418562;1043.879953805307;29417;30264.84867575692;30389.50520690105;30565.847170764006;30814.383712325627;772.8570214510333;907.4283201582961;1020.9285350025575;1070.3043022035583;1081.5781845080426;13344.933275333562;15244.847551524565;15596.454124105601;15601.609959751097;16000.839991600167;620506;625445;626363;626782;627590;41661;42234.78882605629;42402.36396453994;42504;42505.08727107287;1294.9482020719065;1318.914270572429;1353.8578449262882;1356.247282758059;1357.911735737174;29065.854670726512;29843.701562984093;29942.95199668001;30428.391432171677;30575;49531.25703114528;49566.256506151716;49869.00261994812;50034.49965500298;50146;616327;617966;618416.9079154575;619101;621647;26552;26774.196774096807;26903.730962690122;26970.190894273204;27546.72453275522;46430.53569464397;47052.52947470482;47919;48125;48553;38802.02994925036;38890;39348.606513934494;40686.389704153866;40708.389374160004;38750.22499549937;38756.41865371965;39568.80215598903;39870.80064599658;40088.1982360357;37753.81123094367;37864.43203352007;38579.80710096432;39038.609613904635;39268.21463570656;32125;34543;35208.823955880056;35309.823450882584;35313.823430883705;25775.097871574406;25837.095701650353;26132.477350453264;26188.8690556546;26246.868765656815 11:10:50 INFO - PROCESS | 1651 | |2;jquery.html;368.5835006442721;370.88502564205095;378.7386703174809;380.7410960546827;399.7162014969372;19681.127548980396;20413;21203.57592848142;21475.92620368981;21639.67540486894;20639.484012899684;21158.25946091887;21325.893370533166;21376.786232137714;21782.564348713015;5723.227364305828;5790.971045144779;5825.184474173598;5912.822615321547;5913.645181289136;4112.753234805907;5775.913361299584;5903.527717782588;6352.587081839689;6724.529282950171;6463.385978332051;6662.566933149354;6762.256151823295;6775.9661201693925;6798;6460.45086167674;6648.833779155511;6665.600063996128;6720.731170753164;6730.899036514481;5618.662270842675;5693.544516438675;5787.768489260425;5793.449622285918;5807.303123625192;27577.58633620497;27738.722612774018;27940.860295698596;27948.882044718186;28055.15834524947;2191.5069109450246;2302.7466978632337;2701.1896431070795;2864.3125649844096;3175.285560748836;15007.174605396698;15915.840841591667;15982.84017159825;16166.676666466605;16317.428889988912;1817.2549254805467;1840.5214644192472;1848.3530764232412;1861.1345724238158;1901.3440363074717;93285.53357233238;114455;115090.84909150885;116238;117612.41193793976;10583.417912014758;10611.946940265248;10717.78564428707;10754.516046777913;10949.890501094887;12397.876021239852;12960.416781244867;13702;13745.24401157946;13755.587332380044;8376.204260595234;8590.1839325264;8646.308295336357;8660.740177794676;8673.30613550927;7832.843343133105;8358.373122015873;8658.523781191969;8681.262092722189;8890.555472226362;6321.462675672619;6787.762428314985;6812.250652428229;6815.398381380372;6826.283240259801;1413.7949997250341;1469.258024697521;1610.6698126883962;1826.9908650456662;1876.3807943378652;869.3002133282768;882.7837179890968;972.6741541583507;991.6826615482976;1010.3533738407425;16771.664566708598;20772.792272077088;22187.334379968626;22247.666285005736;22428.32715018552;910.4127837544879;961.7451375385529;969.5007071358256;1004.6634377483479;1055.3034996902009;11375.544978200945;11658.53365865356;11809.645710628694;11914.344711040803;11919.702007449883;545332;567932;571712;574835;601845.8431033412;128598.35512336613;130204;130835;131375.34312328376;134143;959.040959040973;982.5164002356494;1001.0690058245901;1003.5283416794096;1005.6882366466273;19402.514937126685;19569.804301957367;19631.60736785285;19717.014149292765;19867;58154.7092264536;58308.4169158303;58391;58478.830423392144;58702.706486467294;84210.57894710488;84360;85631.57184214039;86404;87099.56450217709;7353.154387245535;7400.444966627632;7402.7409040683315;7518.173000969999;7707.576083315472;10782.490451336977;11882.405879705808;12301.507939682671;13051;13606.455741770218;8790.42862213954;9811.018898110131;11570.94214528922;11676.591319303783;11915.702107447383;9061.546922653974;10049.497525123861;11646.592369267035;11679.474423650787;11707.531698731955;11617.593384231512;11674.357910315015;11882.227655202385;11908.40457977115;12032.639020829389;8245.175482451707;8457.577121143795;8589.82820343577;11834.875686809739;11926.224795388272;11145.609903653332;11670.766584668088;11675.941620291844;11683.415829208336;11748.412579371168 11:10:50 INFO - PROCESS | 1651 | |3;mootools.html;1285.7492788906163;1439.7192547453244;1578.329210085714;1784.7233678779794;1837.8162183781624;7335.816604584875;8000;8521.573921303941;9100.317476189279;9117.407368521042;8791.560421978907;9003.639854405832;9005.369624126297;9005.369624126313;9021.368504204693;2382.356763673807;2406.602910519762;2415.2754173747803;2416.7704068113503;2426.38127277544;2404.386881345263;2409.229046705055;2444.3889027742975;2445.486447845946;2455.287966489716;2406.470576473173;2429.6234083716963;2436.2812970173754;2444.8655323957173;2445.963310550343;2396.448816772152;2403.639454081884;2415.0800113909395;2416.9758302417104;2424.648425978232;2400.867952262625;2408.0488207158073;2416.637504374358;2416.734159242482;2423.6728041714496;7671.808204794869;8940.284777217807;9082.000979892207;9095.090490950919;9126.543672816333;5356.625036247464;5498.120300751901;5501.229827824108;5508.173773933902;5526.50261476469;3125.5936728225183;3569.5181150544863;3710.4619830124752;3773.811309434545;3790.4124860646643;977.750673578233;1102.2064113838023;1105.2981356838386;1113.2986218682258;1121.770037142384;11659.533618655329;11845.82231266523;11883.821742673867;11910.583129590423;12018.038556915426;4470.642348612103;4550.5449455054895;4708.199606066977;4734.715917044989;4750.168720473903;9253.167214950552;9356.672516461891;9379.343445958853;9394.295427842939;9428.858567121499;5320.813771517978;5335.119705248668;5338.97330513345;5342.278792362981;5351.464853514617;3815.771053736785;4841.2496063110275;4961.925571116436;4964.478729733398;4974.701517908937;3239.8056116632606;3835.4822099016274;3951.1702542465828;3975.1453437511072;3980.3432433648704;1182.6747644397688;1188.1623455463878;1192.624323338163;1195.2410219510673;1198.071494591681;861.3711990247155;901.4771432569095;909.8498747706554;919.2829592917535;970.0396607358664;4789.521047895252;5911.793087241926;6028.577999540078;6062.514998800086;6159.3224745277985;419.6789456066112;426.6458839163487;454.66354897375703;459.6322941646669;464.9418822647169;4055.1281474483126;4115.855945041909;4135.648469880034;4145.005198752338;4166.166766646683;10681.412522311348;10974.725631859268;11049;11056.889431105586;11087.889121108847;9084.40951338161;9289.303302252223;11055.281406708538;11073.889261107286;11092.001719845253;7047.541909775849;7820.882686759704;8133.437967040481;8285.461445005934;8358.749237522885;5057;6022;6042.425969532887;6069.119977603134;6216.098665693539;9006.594703238501;9940.155086817413;10212;10224.386536807815;10247.436390998566;8508.702195423131;9804.509774511389;9970.601175952881;10327.277090603586;10483.528241229316;6990.545614535039;7231.49379543448;7363.190049094703;7373.041504604367;7388.519746216479;7478.663460144197;8459.069502354612;8490.957545212234;8533.74398768013;8543.444676096035;7012.228654848064;7113.8577228454105;7119.928800712134;7160.391366733677;7269.236730143259;7359.411247100326;7472.40220782347;7475.289847464483;7514.286142816423;7528;7142.071530700976;7228.421726261991;7243.855122897407;7264.818379540554;7281.543691261663;5089.338386009795;5098.2352647103235;5149.9742501287255;5180.818671346485;5230.084735171254;5092.287079808756;5102.540771330449;5134.409542902465;5215.504527069922;5360.195970604441 11:10:50 INFO - PROCESS | 1651 | |4;prototype.html;257.59171712835155;302.2911273064664;311.9067667824276;315.63544106556935;317.44130330618106;5388.272583201267;5457.645253058553;5491.368492623349;5650.350209725878;5658.773649054038;4858.4898585648525;4911.495137479884;5516.503514683678;5617.494425501704;5671.376148623648;3590.5943018177754;4088.632023117919;4170.456021826683;4186.120914607936;4240.427542281784;4088.4276201331836;4163.413232759261;4207.758711180194;4257.978710106445;4285.185814695198;4179.456670632813;4200.495940487146;4200.831966721327;4218.713292445803;4226.746395216282;3718.233838926515;4192.155451601286;4206.3690446432975;4213.662906967435;4253.936190957138;3099.3491366812996;3612.674859262679;3645.505342809435;3654.4701018352457;3667.0465678923406;5349.090654588729;5448.291722076145;5457.863553411157;5507.697076660782;5513.531349835269;4611.792469338888;4809.326694262806;4820.818899369677;4859.343988561534;4901.362822833044;4213.9578604213875;4675.976620116911;5746.678263999262;5929.703514824241;5958.433948774903;3690.892732180362;3952.980235098835;4000.219902143547;4004.4593979812644;4028.5165780106577;5468.507834294893;5488.4785945335125;6095.359987201368;6231.597890474607;6331.715072821688;3802.391617341212;3911.9486800295813;4062.8171732272117;4068.816903239361;4077.388391741203;3748.8125593720206;3985.501812273466;3991.0244429007826;4069;4134.896627584334;4117.91764164721;4711.670183087151;4732.337472753818;4737.597304229179;4788.95211047892;4998.02538504988;5936.782959493294;5936.8126374725225;5981.222441082718;5981.581289309794;1312.2126723965544;1359.3483917040842;1376.8898488120926;1382.2466755618211;1384.9099808512415;814.7637185216221;886.7694399456059;889.3797593442939;917.3486824354783;920.3925409229876;5413.750206088202;5464.617476776667;5495.642783219078;5516.227728118067;5518.33779946401;5976.207137858625;5984.379450432512;5986.5809393342915;5995.46040856325;6025.698715064229;4558.840440584564;4763.7141771493125;5222.190560463135;5508.724563771795;5527.766256739772;2317.43222910388;2378.5956387413835;2654.402759379163;2669.251640175688;2683.5303821831494;4598.908021839545;4749.382580264543;5241.371035475768;5249.737513124329;5263.236830659533;4408.53710360414;4719.5966292862395;5103.566196873233;5137.845864624067;5172.689638621695;4642.353858300736;5191.740412979336;5212.687238765686;5222.7127507987425;5257.08001099806;4486.878280429893;4724.787384567634;5058.974705126451;5090.745462726923;5102.2498463629945;4409.955900440955;4449.399331090391;4488.932666009947;4999.950000499948;5024.648274620888;4720.740359280273;5099.311592934906;5207.140821764518;5228.581713462838;5247.2129180623215;2871.8851245949927;3203.615566132079;3432.5880894292845;3474.3844112487814;3482.21650128719;4692.296155576691;4761.952380476151;5032.421271553818;5047.6214283929585;5053.469385714594;4444.888877778081;4660.557247061523;4885.291632713165;4916.205584961534;4927.581155601814;4229.746215227096;4392.66023862725;4434.37918691377;4662.300654901656;4932.482089380564;4825.686330388514;4854.466008738966;4860.927086093782;5176.559992400688;5785.82642520725;5370.892582148257;5669.667628107474;5910.404190868528;5933.757363485129;5940.831596467172;5486.1770734388565;5810.448007439287;5823.883522329615;5829.8251052468495;5888.852778680396 11:10:50 INFO - PROCESS | 1651 | |5;yui.html;708.585477495665;708.7023450150937;716.3552802477769;774.0479210570998;821.6918655504186;15364.154971476579;16231.756523652126;16239.75640365394;16277.755833662504;16286.592835179126;12846.48614055439;14485.493007744732;14613.488527901525;14619.342129604167;14627.780583291233;653.5261935097064;691.778630838132;807.9232472915064;825.3314814999869;850.0861573808181;856.9357298202628;858.9613467393982;859.188067276424;860.109786371106;863.9265662418702;894.2935081285776;901.923336516397;904.0191392339287;908.8727578139033;910.1035480052143;892.1346294094718;902.1294450854891;903.7695387676133;904.0642934562761;906.9455832650062;666.6500087454125;677.6476232359146;678.1895634716516;678.4131726056975;681.2982627893277;14819.40722371104;14868.70262594742;15014.174220417872;15054;15076.849231507655;14883.404663813435;14910.478133265393;14945;14946.850531494654;15008;11983.700407489796;12165;12185.939070304681;12331.321777302244;12511.874881251162;3747.362948298796;3821.847126114952;3840.8463661453507;3942.1918506706056;3963.029057880809;112467;113189;113312.43343783228;113555;117345.82654173435;11394.202405831513;11400.885991139983;11425.657230283105;11603.071754259809;11746.353950532803;19778;23377;23493.17773877906;23580.288266849187;23692.407689807547;8145.551994640352;8248.587570621445;8252.257296843312;8351.791205219919;8361.581920903931;4519.7740112994215;4545.2954792007295;4549.954500455019;4555.886102847389;4556.384888040138;3573.5711714594413;3690.4833323334756;3722.3113723961155;3736.1967177057063;3744.9063773405883;653.738504598155;667.7228949985798;671.5232185148501;681.1111499493209;683.3815397065664;581.2472847662287;594.878049999749;648.73726140913;654.3564001434247;673.7810211681223;9544.952275238718;9569.090936361035;9626;9768.706938791847;9786.804263914682;515.3352175693389;639.7792761497369;647.090837373491;658.1040241768645;675.97927130034;4464.441944756905;4718.103560323528;4753.667243293005;4782.258749893772;4842.418909730784;107490.46254768677;147421.26289368485;150569.24715376354;166496;171010;132162;134319;135321;138196;138232;108441;108445.45777271064;119198.40400798114;122097;122893.38553307355;7994.61104735302;10007.077911471684;10039.899601003897;10052.497375131361;10164;47586.04827903353;54253.45746542484;56633;60419.95800419923;61048.69475652593;78596.82104768319;80361;81414.77877831718;88370;94056;9572.521373931415;10642.8403573948;12929.288889111189;12949.935250324064;13433.328333583477;14668.339924703201;14884.032537885003;14995;15208.771868421762;15229.695406091594;14035.649108772363;14152.78770818459;14171.645708856948;14532.273386330853;14596.85403145955;11903.821442678194;13836.654083647989;14047.946404019534;14479.92760036193;14561.781573276621;13773.931130344285;13849.79225311601;13972.510962116683;13996.860031399556;14431.3505892233;11200.327980321206;11205.887941120485;11537.01935335506;11840.407979601157;11962.10284228669;9481.573329200064;10380.532876020447;11214.95327102775;11667;11708.590199342982 11:10:50 INFO - PROCESS | 1651 | __end_tp_report 11:10:50 INFO - PROCESS | 1651 | __start_cc_report 11:10:50 INFO - PROCESS | 1651 | _x_x_mozilla_cycle_collect,428 11:10:50 INFO - PROCESS | 1651 | __end_cc_report 11:10:50 INFO - PROCESS | 1651 | __startTimestamp1471889450423__endTimestamp 11:10:50 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | ------- Summary: start ------- 11:10:50 INFO - PROCESS | 1651 | Number of tests: 6 11:10:50 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | [#0] dojo.html Cycles:165 Average:5756.16 Median:6012.16 stddev:684.01 (11.4%) stddev-sans-first:647.62 11:10:50 INFO - PROCESS | 1651 | Values: 2872.6 3440.9 3461.4 3466.8 3479.7 4608.1 5456.8 5730.4 5754.9 5809.7 5746.6 5764.2 5766.4 5797.9 5809.9 5288.4 5320.9 5376.0 5406.4 5427.6 5153.5 5186.8 5253.1 5335.4 5345.9 4427.8 5299.0 5304.9 5307.0 5320.1 5319.9 5324.1 5328.5 5336.9 5337.8 5110.9 5165.4 5251.1 5270.6 5282.1 5761.0 5816.3 5817.7 5848.2 5851.7 6231.5 6264.1 6291.9 6296.6 6304.3 6186.3 6191.6 6238.9 6306.9 6329.2 5955.6 5959.4 5982.3 6010.2 6012.2 6394.4 6419.3 6454.1 6468.4 6468.7 6112.9 6146.9 6172.3 6277.8 6296.5 6267.0 6273.4 6313.7 6314.3 6322.7 6229.3 6254.8 6284.1 6296.4 6304.6 6148.2 6167.4 6203.5 6273.0 6283.5 4806.2 5031.3 5031.5 5046.6 5049.5 4461.4 4470.2 4503.9 4509.6 4524.7 4892.7 5759.8 5882.9 5884.5 6040.3 6336.5 6339.8 6340.5 6349.2 6366.5 5995.6 5999.6 6037.6 6078.1 6099.0 4742.7 5366.3 5371.5 5512.0 5557.2 5040.8 5404.9 6271.7 6564.9 6589.7 6337.3 6342.7 6350.9 6357.6 6371.5 4967.3 6253.5 6408.6 6559.4 6565.0 6180.4 6247.3 6262.5 6269.2 6274.6 5222.6 5515.7 6027.0 6283.5 6296.4 5264.4 5505.6 5899.0 6075.4 6179.6 6192.4 6242.3 6248.5 6250.4 6279.4 5030.0 5409.8 5846.2 6103.1 6141.8 5110.8 6039.4 6101.1 6177.9 6275.7 6102.8 6164.2 6169.6 6173.0 6181.4 11:10:50 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | [#1] ext.html Cycles:180 Average:70569.16 Median:39493.90 stddev:157091.39 (397.8%) stddev-sans-first:157443.95 11:10:50 INFO - PROCESS | 1651 | Values: 488.0 526.8 535.6 540.3 560.9 27699.4 32653.5 39340.6 39408.8 39419.0 33889.0 40812.6 41465.0 41479.8 41520.8 9571.4 9719.9 9733.8 9736.3 9757.0 9542.8 9639.2 9665.2 9685.7 9686.0 9649.8 9652.8 9662.3 9681.2 9688.8 9584.0 9593.5 9608.1 9641.7 9670.1 9583.4 9631.0 9673.2 9680.8 9702.8 38758.6 38797.6 38956.6 39185.2 39215.4 3556.6 3649.9 3667.9 3987.3 4145.9 25888.7 27913.6 30591.8 31645.8 31731.7 3232.2 3378.7 3398.2 3430.1 3430.6 506346.0 507203.0 510603.0 510897.0 514875.0 55050.2 55534.4 55550.0 55552.7 55560.2 58666.7 59174.0 59187.4 59219.0 59294.4 15855.0 15985.6 15997.5 16077.4 16088.2 12350.7 12424.6 12520.1 12566.8 12567.2 13942.9 15275.5 15306.0 15341.5 15363.5 2861.7 3246.2 5440.4 6490.3 6529.5 689.5 822.3 883.3 1011.6 1043.9 29417.0 30264.8 30389.5 30565.8 30814.4 772.9 907.4 1020.9 1070.3 1081.6 13344.9 15244.8 15596.5 15601.6 16000.8 620506.0 625445.0 626363.0 626782.0 627590.0 41661.0 42234.8 42402.4 42504.0 42505.1 1294.9 1318.9 1353.9 1356.2 1357.9 29065.9 29843.7 29943.0 30428.4 30575.0 49531.3 49566.3 49869.0 50034.5 50146.0 616327.0 617966.0 618416.9 619101.0 621647.0 26552.0 26774.2 26903.7 26970.2 27546.7 46430.5 47052.5 47919.0 48125.0 48553.0 38802.0 38890.0 39348.6 40686.4 40708.4 38750.2 38756.4 39568.8 39870.8 40088.2 37753.8 37864.4 38579.8 39038.6 39268.2 32125.0 34543.0 35208.8 35309.8 35313.8 25775.1 25837.1 26132.5 26188.9 26246.9 11:10:50 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | [#2] jquery.html Cycles:180 Average:34981.00 Median:2501.97 stddev:95806.68 (3829.3%) stddev-sans-first:96040.19 11:10:50 INFO - PROCESS | 1651 | Values: 368.6 370.9 378.7 380.7 399.7 19681.1 20413.0 21203.6 21475.9 21639.7 20639.5 21158.3 21325.9 21376.8 21782.6 5723.2 5791.0 5825.2 5912.8 5913.6 4112.8 5775.9 5903.5 6352.6 6724.5 6463.4 6662.6 6762.3 6776.0 6798.0 6460.5 6648.8 6665.6 6720.7 6730.9 5618.7 5693.5 5787.8 5793.4 5807.3 27577.6 27738.7 27940.9 27948.9 28055.2 2191.5 2302.7 2701.2 2864.3 3175.3 15007.2 15915.8 15982.8 16166.7 16317.4 1817.3 1840.5 1848.4 1861.1 1901.3 93285.5 114455.0 115090.8 116238.0 117612.4 10583.4 10611.9 10717.8 10754.5 10949.9 12397.9 12960.4 13702.0 13745.2 13755.6 8376.2 8590.2 8646.3 8660.7 8673.3 7832.8 8358.4 8658.5 8681.3 8890.6 6321.5 6787.8 6812.3 6815.4 6826.3 1413.8 1469.3 1610.7 1827.0 1876.4 869.3 882.8 972.7 991.7 1010.4 16771.7 20772.8 22187.3 22247.7 22428.3 910.4 961.7 969.5 1004.7 1055.3 11375.5 11658.5 11809.6 11914.3 11919.7 545332.0 567932.0 571712.0 574835.0 601845.8 128598.4 130204.0 130835.0 131375.3 134143.0 959.0 982.5 1001.1 1003.5 1005.7 19402.5 19569.8 19631.6 19717.0 19867.0 58154.7 58308.4 58391.0 58478.8 58702.7 84210.6 84360.0 85631.6 86404.0 87099.6 7353.2 7400.4 7402.7 7518.2 7707.6 10782.5 11882.4 12301.5 13051.0 13606.5 8790.4 9811.0 11570.9 11676.6 11915.7 9061.5 10049.5 11646.6 11679.5 11707.5 11617.6 11674.4 11882.2 11908.4 12032.6 8245.2 8457.6 8589.8 11834.9 11926.2 11145.6 11670.8 11675.9 11683.4 11748.4 11:10:50 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | [#3] mootools.html Cycles:180 Average:5687.88 Median:5095.26 stddev:3191.41 (62.6%) stddev-sans-first:3183.21 11:10:50 INFO - PROCESS | 1651 | Values: 1285.7 1439.7 1578.3 1784.7 1837.8 7335.8 8000.0 8521.6 9100.3 9117.4 8791.6 9003.6 9005.4 9005.4 9021.4 2382.4 2406.6 2415.3 2416.8 2426.4 2404.4 2409.2 2444.4 2445.5 2455.3 2406.5 2429.6 2436.3 2444.9 2446.0 2396.4 2403.6 2415.1 2417.0 2424.6 2400.9 2408.0 2416.6 2416.7 2423.7 7671.8 8940.3 9082.0 9095.1 9126.5 5356.6 5498.1 5501.2 5508.2 5526.5 3125.6 3569.5 3710.5 3773.8 3790.4 977.8 1102.2 1105.3 1113.3 1121.8 11659.5 11845.8 11883.8 11910.6 12018.0 4470.6 4550.5 4708.2 4734.7 4750.2 9253.2 9356.7 9379.3 9394.3 9428.9 5320.8 5335.1 5339.0 5342.3 5351.5 3815.8 4841.2 4961.9 4964.5 4974.7 3239.8 3835.5 3951.2 3975.1 3980.3 1182.7 1188.2 1192.6 1195.2 1198.1 861.4 901.5 909.8 919.3 970.0 4789.5 5911.8 6028.6 6062.5 6159.3 419.7 426.6 454.7 459.6 464.9 4055.1 4115.9 4135.6 4145.0 4166.2 10681.4 10974.7 11049.0 11056.9 11087.9 9084.4 9289.3 11055.3 11073.9 11092.0 7047.5 7820.9 8133.4 8285.5 8358.7 5057.0 6022.0 6042.4 6069.1 6216.1 9006.6 9940.2 10212.0 10224.4 10247.4 8508.7 9804.5 9970.6 10327.3 10483.5 6990.5 7231.5 7363.2 7373.0 7388.5 7478.7 8459.1 8491.0 8533.7 8543.4 7012.2 7113.9 7119.9 7160.4 7269.2 7359.4 7472.4 7475.3 7514.3 7528.0 7142.1 7228.4 7243.9 7264.8 7281.5 5089.3 5098.2 5150.0 5180.8 5230.1 5092.3 5102.5 5134.4 5215.5 5360.2 11:10:50 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | [#4] prototype.html Cycles:180 Average:4451.61 Median:4823.25 stddev:1357.59 (28.1%) stddev-sans-first:1324.40 11:10:50 INFO - PROCESS | 1651 | Values: 257.6 302.3 311.9 315.6 317.4 5388.3 5457.6 5491.4 5650.4 5658.8 4858.5 4911.5 5516.5 5617.5 5671.4 3590.6 4088.6 4170.5 4186.1 4240.4 4088.4 4163.4 4207.8 4258.0 4285.2 4179.5 4200.5 4200.8 4218.7 4226.7 3718.2 4192.2 4206.4 4213.7 4253.9 3099.3 3612.7 3645.5 3654.5 3667.0 5349.1 5448.3 5457.9 5507.7 5513.5 4611.8 4809.3 4820.8 4859.3 4901.4 4214.0 4676.0 5746.7 5929.7 5958.4 3690.9 3953.0 4000.2 4004.5 4028.5 5468.5 5488.5 6095.4 6231.6 6331.7 3802.4 3911.9 4062.8 4068.8 4077.4 3748.8 3985.5 3991.0 4069.0 4134.9 4117.9 4711.7 4732.3 4737.6 4789.0 4998.0 5936.8 5936.8 5981.2 5981.6 1312.2 1359.3 1376.9 1382.2 1384.9 814.8 886.8 889.4 917.3 920.4 5413.8 5464.6 5495.6 5516.2 5518.3 5976.2 5984.4 5986.6 5995.5 6025.7 4558.8 4763.7 5222.2 5508.7 5527.8 2317.4 2378.6 2654.4 2669.3 2683.5 4598.9 4749.4 5241.4 5249.7 5263.2 4408.5 4719.6 5103.6 5137.8 5172.7 4642.4 5191.7 5212.7 5222.7 5257.1 4486.9 4724.8 5059.0 5090.7 5102.2 4410.0 4449.4 4488.9 5000.0 5024.6 4720.7 5099.3 5207.1 5228.6 5247.2 2871.9 3203.6 3432.6 3474.4 3482.2 4692.3 4762.0 5032.4 5047.6 5053.5 4444.9 4660.6 4885.3 4916.2 4927.6 4229.7 4392.7 4434.4 4662.3 4932.5 4825.7 4854.5 4860.9 5176.6 5785.8 5370.9 5669.7 5910.4 5933.8 5940.8 5486.2 5810.4 5823.9 5829.8 5888.9 11:10:50 INFO - PROCESS | 1651 | 11:10:50 INFO - PROCESS | 1651 | [#5] yui.html Cycles:180 Average:25120.25 Median:23636.35 stddev:40394.09 (170.9%) stddev-sans-first:40465.82 11:10:50 INFO - PROCESS | 1651 | Values: 708.6 708.7 716.4 774.0 821.7 15364.2 16231.8 16239.8 16277.8 16286.6 12846.5 14485.5 14613.5 14619.3 14627.8 653.5 691.8 807.9 825.3 850.1 856.9 859.0 859.2 860.1 863.9 894.3 901.9 904.0 908.9 910.1 892.1 902.1 903.8 904.1 906.9 666.7 677.6 678.2 678.4 681.3 14819.4 14868.7 15014.2 15054.0 15076.8 14883.4 14910.5 14945.0 14946.9 15008.0 11983.7 12165.0 12185.9 12331.3 12511.9 3747.4 3821.8 3840.8 3942.2 3963.0 112467.0 113189.0 113312.4 113555.0 117345.8 11394.2 11400.9 11425.7 11603.1 11746.4 19778.0 23377.0 23493.2 23580.3 23692.4 8145.6 8248.6 8252.3 8351.8 8361.6 4519.8 4545.3 4550.0 4555.9 4556.4 3573.6 3690.5 3722.3 3736.2 3744.9 653.7 667.7 671.5 681.1 683.4 581.2 594.9 648.7 654.4 673.8 9545.0 9569.1 9626.0 9768.7 9786.8 515.3 639.8 647.1 658.1 676.0 4464.4 4718.1 4753.7 4782.3 4842.4 107490.5 147421.3 150569.2 166496.0 171010.0 132162.0 134319.0 135321.0 138196.0 138232.0 108441.0 108445.5 119198.4 122097.0 122893.4 7994.6 10007.1 10039.9 10052.5 10164.0 47586.0 54253.5 56633.0 60420.0 61048.7 78596.8 80361.0 81414.8 88370.0 94056.0 9572.5 10642.8 12929.3 12949.9 13433.3 14668.3 14884.0 14995.0 15208.8 15229.7 14035.6 14152.8 14171.6 14532.3 14596.9 11903.8 13836.7 14047.9 14479.9 14561.8 13773.9 13849.8 13972.5 13996.9 14431.4 11200.3 11205.9 11537.0 11840.4 11962.1 9481.6 10380.5 11215.0 11667.0 11708.6 11:10:50 INFO - PROCESS | 1651 | -------- Summary: end -------- 11:10:50 INFO - PROCESS | 1651 | 11:10:51 INFO - TEST-INFO | 1651: exit 0 11:10:51 INFO - TEST-OK | dromaeo_css | took 1114038ms 11:10:51 INFO - TEST-START | kraken 11:10:51 INFO - operating with platform_type : mac_ 11:10:51 INFO - Initialising browser for kraken test... 11:10:51 INFO - TEST-INFO | started process 1664 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/tmpGdOmmL/profile http://localhost:49270/getInfo.html) 11:10:53 INFO - PROCESS | 1664 | __metrics Screen width/height:1600/1200 11:10:53 INFO - PROCESS | 1664 | colorDepth:24 11:10:53 INFO - PROCESS | 1664 | Browser inner width/height: 1024/689 11:10:53 INFO - PROCESS | 1664 | __metrics 11:10:53 ERROR - PROCESS | 1664 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2993: TypeError: this.tabs is undefined 11:10:54 INFO - TEST-INFO | 1664: exit 0 11:10:54 INFO - Browser initialized. 11:10:54 INFO - Running cycle 1/1 for kraken test... 11:10:54 INFO - TEST-INFO | started process 1666 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/T/tmpGdOmmL/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:11:06 INFO - PROCESS | 1666 | RSS: Main: 239808512 11:11:06 INFO - PROCESS | 1666 | 11:11:09 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-beat-detection) 11:11:10 INFO - PROCESS | 1666 | RSS: Main: 252518400 11:11:10 INFO - PROCESS | 1666 | 11:11:13 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-dft) 11:11:13 INFO - PROCESS | 1666 | RSS: Main: 261181440 11:11:13 INFO - PROCESS | 1666 | 11:11:17 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-fft) 11:11:17 INFO - PROCESS | 1666 | RSS: Main: 264110080 11:11:17 INFO - PROCESS | 1666 | 11:11:19 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-oscillator) 11:11:20 INFO - PROCESS | 1666 | RSS: Main: 266559488 11:11:20 INFO - PROCESS | 1666 | 11:11:22 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:11:23 INFO - PROCESS | 1666 | RSS: Main: 267595776 11:11:23 INFO - PROCESS | 1666 | 11:11:26 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-darkroom) 11:11:27 INFO - PROCESS | 1666 | RSS: Main: 267137024 11:11:27 INFO - PROCESS | 1666 | 11:11:29 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-desaturate) 11:11:30 INFO - PROCESS | 1666 | RSS: Main: 267300864 11:11:30 INFO - PROCESS | 1666 | 11:11:33 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49270/tests/kraken/driver.html?testName=json-parse-financial) 11:11:34 INFO - PROCESS | 1666 | RSS: Main: 267542528 11:11:34 INFO - PROCESS | 1666 | 11:11:35 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49270/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:11:36 INFO - PROCESS | 1666 | RSS: Main: 267325440 11:11:36 INFO - PROCESS | 1666 | 11:11:38 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:11:39 INFO - PROCESS | 1666 | RSS: Main: 267350016 11:11:39 INFO - PROCESS | 1666 | 11:11:41 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:11:42 INFO - PROCESS | 1666 | RSS: Main: 267493376 11:11:42 INFO - PROCESS | 1666 | 11:11:45 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:11:45 INFO - PROCESS | 1666 | RSS: Main: 267735040 11:11:45 INFO - PROCESS | 1666 | 11:11:48 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:11:49 INFO - PROCESS | 1666 | RSS: Main: 267595776 11:11:49 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49270/tests/kraken/driver.html?testName=ai-astar) 11:11:51 INFO - PROCESS | 1666 | RSS: Main: 269828096 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | __start_tp_report 11:11:51 INFO - PROCESS | 1666 | _x_x_mozilla_page_load 11:11:51 INFO - PROCESS | 1666 | _x_x_mozilla_page_load_details 11:11:51 INFO - PROCESS | 1666 | |i|pagename|runs| 11:11:51 INFO - PROCESS | 1666 | |0;ai-astar;105;116;105;155;170;161;118;117;116;115 11:11:51 INFO - PROCESS | 1666 | |1;audio-beat-detection;144;113;139;189;142;136;129;93;160;131 11:11:51 INFO - PROCESS | 1666 | |2;audio-dft;200;203;238;200;197;227;195;276;267;201 11:11:51 INFO - PROCESS | 1666 | |3;audio-fft;69;87;75;143;60;59;58;63;135;59 11:11:51 INFO - PROCESS | 1666 | |4;audio-oscillator;71;73;132;100;81;74;117;70;75;116 11:11:51 INFO - PROCESS | 1666 | |5;imaging-gaussian-blur;136;86;103;131;108;85;111;123;136;94 11:11:51 INFO - PROCESS | 1666 | |6;imaging-darkroom;95;96;95;115;136;95;95;95;96;94 11:11:51 INFO - PROCESS | 1666 | |7;imaging-desaturate;90;93;92;105;156;118;92;91;92;91 11:11:51 INFO - PROCESS | 1666 | |8;json-parse-financial;58;59;59;78;86;86;88;91;57;57 11:11:51 INFO - PROCESS | 1666 | |9;json-stringify-tinderbox;67;69;76;71;82;76;73;69;69;72 11:11:51 INFO - PROCESS | 1666 | |10;stanford-crypto-aes;84;94;85;83;89;88;107;116;109;79 11:11:51 INFO - PROCESS | 1666 | |11;stanford-crypto-ccm;142;159;157;154;156;153;162;160;174;144 11:11:51 INFO - PROCESS | 1666 | |12;stanford-crypto-pbkdf2;167;213;236;230;171;170;167;168;168;173 11:11:51 INFO - PROCESS | 1666 | |13;stanford-crypto-sha256-iterative;70;70;68;68;68;69;82;67;67;69 11:11:51 INFO - PROCESS | 1666 | __end_tp_report 11:11:51 INFO - PROCESS | 1666 | __start_cc_report 11:11:51 INFO - PROCESS | 1666 | _x_x_mozilla_cycle_collect,1096 11:11:51 INFO - PROCESS | 1666 | __end_cc_report 11:11:51 INFO - PROCESS | 1666 | __startTimestamp1471889511351__endTimestamp 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | ------- Summary: start ------- 11:11:51 INFO - PROCESS | 1666 | Number of tests: 14 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#0] ai-astar Cycles:10 Average:127.80 Median:117.50 stddev:24.31 (20.7%) stddev-sans-first:24.34 11:11:51 INFO - PROCESS | 1666 | Values: 105.0 116.0 105.0 155.0 170.0 161.0 118.0 117.0 116.0 115.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#1] audio-beat-detection Cycles:10 Average:137.60 Median:143.00 stddev:25.65 (17.9%) stddev-sans-first:27.10 11:11:51 INFO - PROCESS | 1666 | Values: 144.0 113.0 139.0 189.0 142.0 136.0 129.0 93.0 160.0 131.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#2] audio-dft Cycles:10 Average:220.40 Median:215.00 stddev:30.41 (14.1%) stddev-sans-first:31.34 11:11:51 INFO - PROCESS | 1666 | Values: 200.0 203.0 238.0 200.0 197.0 227.0 195.0 276.0 267.0 201.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#3] audio-fft Cycles:10 Average:80.80 Median:61.50 stddev:32.04 (52.1%) stddev-sans-first:33.70 11:11:51 INFO - PROCESS | 1666 | Values: 69.0 87.0 75.0 143.0 60.0 59.0 58.0 63.0 135.0 59.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#4] audio-oscillator Cycles:10 Average:90.90 Median:72.00 stddev:23.27 (32.3%) stddev-sans-first:23.54 11:11:51 INFO - PROCESS | 1666 | Values: 71.0 73.0 132.0 100.0 81.0 74.0 117.0 70.0 75.0 116.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#5] imaging-gaussian-blur Cycles:10 Average:111.30 Median:136.00 stddev:19.60 (14.4%) stddev-sans-first:18.64 11:11:51 INFO - PROCESS | 1666 | Values: 136.0 86.0 103.0 131.0 108.0 85.0 111.0 123.0 136.0 94.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#6] imaging-darkroom Cycles:10 Average:101.20 Median:95.00 stddev:13.74 (14.5%) stddev-sans-first:14.39 11:11:51 INFO - PROCESS | 1666 | Values: 95.0 96.0 95.0 115.0 136.0 95.0 95.0 95.0 96.0 94.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#7] imaging-desaturate Cycles:10 Average:102.00 Median:91.50 stddev:20.94 (22.9%) stddev-sans-first:21.76 11:11:51 INFO - PROCESS | 1666 | Values: 90.0 93.0 92.0 105.0 156.0 118.0 92.0 91.0 92.0 91.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#8] json-parse-financial Cycles:10 Average:71.90 Median:82.00 stddev:15.01 (18.3%) stddev-sans-first:15.06 11:11:51 INFO - PROCESS | 1666 | Values: 58.0 59.0 59.0 78.0 86.0 86.0 88.0 91.0 57.0 57.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#9] json-stringify-tinderbox Cycles:10 Average:72.40 Median:72.50 stddev:4.53 (6.2%) stddev-sans-first:4.36 11:11:51 INFO - PROCESS | 1666 | Values: 67.0 69.0 76.0 71.0 82.0 76.0 73.0 69.0 69.0 72.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#10] stanford-crypto-aes Cycles:10 Average:93.40 Median:84.50 stddev:12.75 (15.1%) stddev-sans-first:13.06 11:11:51 INFO - PROCESS | 1666 | Values: 84.0 94.0 85.0 83.0 89.0 88.0 107.0 116.0 109.0 79.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#11] stanford-crypto-ccm Cycles:10 Average:156.10 Median:158.00 stddev:9.06 (5.7%) stddev-sans-first:8.05 11:11:51 INFO - PROCESS | 1666 | Values: 142.0 159.0 157.0 154.0 156.0 153.0 162.0 160.0 174.0 144.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:186.30 Median:172.00 stddev:28.25 (16.4%) stddev-sans-first:29.09 11:11:51 INFO - PROCESS | 1666 | Values: 167.0 213.0 236.0 230.0 171.0 170.0 167.0 168.0 168.0 173.0 11:11:51 INFO - PROCESS | 1666 | 11:11:51 INFO - PROCESS | 1666 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.80 Median:69.00 stddev:4.42 (6.4%) stddev-sans-first:4.68 11:11:51 INFO - PROCESS | 1666 | Values: 70.0 70.0 68.0 68.0 68.0 69.0 82.0 67.0 67.0 69.0 11:11:51 INFO - PROCESS | 1666 | -------- Summary: end -------- 11:11:51 INFO - PROCESS | 1666 | 11:11:52 INFO - TEST-INFO | 1666: exit 0 11:11:52 INFO - TEST-OK | kraken | took 61019ms 11:11:52 INFO - SUITE-END | took 1175s 11:11:52 INFO - Completed test suite (00:19:35) 11:11:52 INFO - javascript benchmark 11:11:52 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7355.157452670309, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2872.569114632805, 3440.9483857742134, 3461.4115600347936, 3466.774659647121, 3479.6520347965206, 4608.124456353291, 5456.781728730846, 5730.398308177644, 5754.878158438993, 5809.651420914743, 5746.597738158331, 5764.193012978176, 5766.394528574502, 5797.898399304129, 5809.854753631162, 5288.391834938983, 5320.893582128355, 5376.0, 5406.405295417501, 5427.592930530206, 5153.484651534835, 5186.818461353853, 5253.133233016548, 5335.386430560497, 5345.930813837229, 4427.760227136407, 5299.0, 5304.867378315573, 5306.973465132688, 5320.122179840322, 5319.946800532022, 5324.068288049614, 5328.5470734987575, 5336.893262134774, 5337.786488540453, 5110.923336149961, 5165.431802501722, 5251.054810134175, 5270.578353731692, 5282.128448805943, 5761.0, 5816.272965879265, 5817.7091145442555, 5848.181254624356, 5851.678157701324, 6231.501479881644, 6264.123022776769, 6291.8741625167695, 6296.559240853142, 6304.27500837405, 6186.257649082139, 6191.597546159485, 6238.906416403712, 6306.873862522724, 6329.1772069631115, 5955.583109182359, 5959.404059594006, 5982.282126144803, 6010.248718910137, 6012.158297838349, 6394.360563943568, 6419.293877673452, 6454.128692626436, 6468.417842394207, 6468.741250349934, 6112.938870611326, 6146.907796383058, 6172.259328880473, 6277.811665650038, 6296.5277604178955, 6267.0286105653695, 6273.37266273369, 6313.747450101944, 6314.336994615499, 6322.683865806691, 6229.314775374705, 6254.843628909222, 6284.088807122942, 6296.433321001132, 6304.621722696653, 6148.200733904564, 6167.444929956326, 6203.534734894901, 6272.968635156886, 6283.5287353448675, 4806.206975848946, 5031.295618613397, 5031.496850315012, 5046.621503387188, 5049.495050494921, 4461.442319710036, 4470.173017991617, 4503.932441013388, 4509.6392288616835, 4524.705894116872, 4892.706437613754, 5759.769609215668, 5882.941170588325, 5884.529237660977, 6040.335563088057, 6336.52476064297, 6339.841503962346, 6340.461060809883, 6349.206349206349, 6366.490680745529, 5995.5803093783015, 5999.5800293979, 6037.63774173551, 6078.057901025348, 6099.0, 4742.73914934675, 5366.275552800322, 5371.543418809445, 5512.007838589093, 5557.194206840067, 5040.79836806531, 5404.891902162013, 6271.686415679289, 6564.901526477202, 6589.703463344065, 6337.334579869232, 6342.651154186379, 6350.872457726713, 6357.618542887441, 6371.458426033653, 4967.279744437109, 6253.530985176039, 6408.61548307103, 6559.442447392025, 6564.9671751640935, 6180.412860778219, 6247.3440288769025, 6262.4990000800735, 6269.216347956505, 6274.592151510137, 5222.6083043771105, 5515.669059856422, 6027.0, 6283.49732021428, 6296.370362963667, 5264.446743329559, 5505.568552176383, 5899.0, 6075.392460753889, 6179.598326108789, 6192.411720886508, 6242.28213755424, 6248.531360148098, 6250.4374606285655, 6279.403456671609, 5030.0, 5409.78360865561, 5846.152307915413, 6103.115048318058, 6141.785037523665, 5110.821121260738, 6039.396060393926, 6101.115338275837, 6177.876442471215, 6275.74897004133, 6102.755889764538, 6164.167837341902, 6169.629822210682, 6173.012318029094, 6181.35095814933], "value": 5714.557749931553, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [487.9512048795121, 526.778752923772, 535.6277387215886, 540.2868213957576, 560.8794109266512, 27699.44601107979, 32653.510197347, 39340.606593934055, 39408.802955985215, 39419.0, 33889.0, 40812.59187408125, 41465.0, 41479.79260103703, 41520.79239603798, 9571.425714457137, 9719.902800972006, 9733.756656083584, 9736.318457707928, 9756.951215243915, 9542.809143817154, 9639.180669643089, 9665.22678185747, 9685.661001864935, 9686.031396860293, 9649.807003859954, 9652.758681032996, 9662.275329350292, 9681.177099946513, 9688.806223875517, 9584.04159584043, 9593.520323983774, 9608.087231712976, 9641.710748677586, 9670.081342272473, 9583.377080489816, 9630.9518452408, 9673.177779888718, 9680.806383872354, 9702.75743106428, 38758.61241387578, 38797.61202387996, 38956.610433895585, 39185.21629567421, 39215.41176882349, 3556.6443355664487, 3649.872254471081, 3667.9266414671556, 3987.302222111148, 4145.91708165835, 25888.74111258882, 27913.581296280572, 30591.847040764653, 31645.84177079123, 31731.682683173105, 3232.2242661761243, 3378.6959173674486, 3398.218409765743, 3430.091025878144, 3430.6054803697643, 506346.0, 507203.0, 510603.0, 510897.0, 514875.0, 55050.17424738632, 55534.44465555293, 55550.0, 55552.72223638937, 55560.16659750107, 58666.706666466394, 59174.0, 59187.40812591819, 59219.0, 59294.40705592889, 15855.0, 15985.60035999086, 15997.520074397788, 16077.356905723875, 16088.195590220443, 12350.691232719075, 12424.56514022005, 12520.1235913487, 12566.81149782754, 12567.18313309632, 13942.930285348508, 15275.541733748005, 15306.0, 15341.463048793239, 15363.539093827203, 2861.6852146263896, 3246.172226082334, 5440.442882319547, 6490.2536208335705, 6529.542931994714, 689.5381790603851, 822.2887202569734, 883.306604315622, 1011.5751384418562, 1043.879953805307, 29417.0, 30264.84867575692, 30389.50520690105, 30565.847170764006, 30814.383712325627, 772.8570214510333, 907.4283201582961, 1020.9285350025575, 1070.3043022035583, 1081.5781845080426, 13344.933275333562, 15244.847551524565, 15596.454124105601, 15601.609959751097, 16000.839991600167, 620506.0, 625445.0, 626363.0, 626782.0, 627590.0, 41661.0, 42234.78882605629, 42402.36396453994, 42504.0, 42505.08727107287, 1294.9482020719065, 1318.914270572429, 1353.8578449262882, 1356.247282758059, 1357.911735737174, 29065.854670726512, 29843.701562984093, 29942.95199668001, 30428.391432171677, 30575.0, 49531.25703114528, 49566.256506151716, 49869.00261994812, 50034.49965500298, 50146.0, 616327.0, 617966.0, 618416.9079154575, 619101.0, 621647.0, 26552.0, 26774.196774096807, 26903.730962690122, 26970.190894273204, 27546.72453275522, 46430.53569464397, 47052.52947470482, 47919.0, 48125.0, 48553.0, 38802.02994925036, 38890.0, 39348.606513934494, 40686.389704153866, 40708.389374160004, 38750.22499549937, 38756.41865371965, 39568.80215598903, 39870.80064599658, 40088.1982360357, 37753.81123094367, 37864.43203352007, 38579.80710096432, 39038.609613904635, 39268.21463570656, 32125.0, 34543.0, 35208.823955880056, 35309.823450882584, 35313.823430883705, 25775.097871574406, 25837.095701650353, 26132.477350453264, 26188.8690556546, 26246.868765656815], "value": 19348.78588612074, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [368.5835006442721, 370.88502564205095, 378.7386703174809, 380.7410960546827, 399.7162014969372, 19681.127548980396, 20413.0, 21203.57592848142, 21475.92620368981, 21639.67540486894, 20639.484012899684, 21158.25946091887, 21325.893370533166, 21376.786232137714, 21782.564348713015, 5723.227364305828, 5790.971045144779, 5825.184474173598, 5912.822615321547, 5913.645181289136, 4112.753234805907, 5775.913361299584, 5903.527717782588, 6352.587081839689, 6724.529282950171, 6463.385978332051, 6662.566933149354, 6762.256151823295, 6775.9661201693925, 6798.0, 6460.45086167674, 6648.833779155511, 6665.600063996128, 6720.731170753164, 6730.899036514481, 5618.662270842675, 5693.544516438675, 5787.768489260425, 5793.449622285918, 5807.303123625192, 27577.58633620497, 27738.722612774018, 27940.860295698596, 27948.882044718186, 28055.15834524947, 2191.5069109450246, 2302.7466978632337, 2701.1896431070795, 2864.3125649844096, 3175.285560748836, 15007.174605396698, 15915.840841591667, 15982.84017159825, 16166.676666466605, 16317.428889988912, 1817.2549254805467, 1840.5214644192472, 1848.3530764232412, 1861.1345724238158, 1901.3440363074717, 93285.53357233238, 114455.0, 115090.84909150885, 116238.0, 117612.41193793976, 10583.417912014758, 10611.946940265248, 10717.78564428707, 10754.516046777913, 10949.890501094887, 12397.876021239852, 12960.416781244867, 13702.0, 13745.24401157946, 13755.587332380044, 8376.204260595234, 8590.1839325264, 8646.308295336357, 8660.740177794676, 8673.30613550927, 7832.843343133105, 8358.373122015873, 8658.523781191969, 8681.262092722189, 8890.555472226362, 6321.462675672619, 6787.762428314985, 6812.250652428229, 6815.398381380372, 6826.283240259801, 1413.7949997250341, 1469.258024697521, 1610.6698126883962, 1826.9908650456662, 1876.3807943378652, 869.3002133282768, 882.7837179890968, 972.6741541583507, 991.6826615482976, 1010.3533738407425, 16771.664566708598, 20772.792272077088, 22187.334379968626, 22247.666285005736, 22428.32715018552, 910.4127837544879, 961.7451375385529, 969.5007071358256, 1004.6634377483479, 1055.3034996902009, 11375.544978200945, 11658.53365865356, 11809.645710628694, 11914.344711040803, 11919.702007449883, 545332.0, 567932.0, 571712.0, 574835.0, 601845.8431033412, 128598.35512336613, 130204.0, 130835.0, 131375.34312328376, 134143.0, 959.040959040973, 982.5164002356494, 1001.0690058245901, 1003.5283416794096, 1005.6882366466273, 19402.514937126685, 19569.804301957367, 19631.60736785285, 19717.014149292765, 19867.0, 58154.7092264536, 58308.4169158303, 58391.0, 58478.830423392144, 58702.706486467294, 84210.57894710488, 84360.0, 85631.57184214039, 86404.0, 87099.56450217709, 7353.154387245535, 7400.444966627632, 7402.7409040683315, 7518.173000969999, 7707.576083315472, 10782.490451336977, 11882.405879705808, 12301.507939682671, 13051.0, 13606.455741770218, 8790.42862213954, 9811.018898110131, 11570.94214528922, 11676.591319303783, 11915.702107447383, 9061.546922653974, 10049.497525123861, 11646.592369267035, 11679.474423650787, 11707.531698731955, 11617.593384231512, 11674.357910315015, 11882.227655202385, 11908.40457977115, 12032.639020829389, 8245.175482451707, 8457.577121143795, 8589.82820343577, 11834.875686809739, 11926.224795388272, 11145.609903653332, 11670.766584668088, 11675.941620291844, 11683.415829208336, 11748.412579371168], "value": 9989.343344627583, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1285.7492788906163, 1439.7192547453244, 1578.329210085714, 1784.7233678779794, 1837.8162183781624, 7335.816604584875, 8000.0, 8521.573921303941, 9100.317476189279, 9117.407368521042, 8791.560421978907, 9003.639854405832, 9005.369624126297, 9005.369624126313, 9021.368504204693, 2382.356763673807, 2406.602910519762, 2415.2754173747803, 2416.7704068113503, 2426.38127277544, 2404.386881345263, 2409.229046705055, 2444.3889027742975, 2445.486447845946, 2455.287966489716, 2406.470576473173, 2429.6234083716963, 2436.2812970173754, 2444.8655323957173, 2445.963310550343, 2396.448816772152, 2403.639454081884, 2415.0800113909395, 2416.9758302417104, 2424.648425978232, 2400.867952262625, 2408.0488207158073, 2416.637504374358, 2416.734159242482, 2423.6728041714496, 7671.808204794869, 8940.284777217807, 9082.000979892207, 9095.090490950919, 9126.543672816333, 5356.625036247464, 5498.120300751901, 5501.229827824108, 5508.173773933902, 5526.50261476469, 3125.5936728225183, 3569.5181150544863, 3710.4619830124752, 3773.811309434545, 3790.4124860646643, 977.750673578233, 1102.2064113838023, 1105.2981356838386, 1113.2986218682258, 1121.770037142384, 11659.533618655329, 11845.82231266523, 11883.821742673867, 11910.583129590423, 12018.038556915426, 4470.642348612103, 4550.5449455054895, 4708.199606066977, 4734.715917044989, 4750.168720473903, 9253.167214950552, 9356.672516461891, 9379.343445958853, 9394.295427842939, 9428.858567121499, 5320.813771517978, 5335.119705248668, 5338.97330513345, 5342.278792362981, 5351.464853514617, 3815.771053736785, 4841.2496063110275, 4961.925571116436, 4964.478729733398, 4974.701517908937, 3239.8056116632606, 3835.4822099016274, 3951.1702542465828, 3975.1453437511072, 3980.3432433648704, 1182.6747644397688, 1188.1623455463878, 1192.624323338163, 1195.2410219510673, 1198.071494591681, 861.3711990247155, 901.4771432569095, 909.8498747706554, 919.2829592917535, 970.0396607358664, 4789.521047895252, 5911.793087241926, 6028.577999540078, 6062.514998800086, 6159.3224745277985, 419.6789456066112, 426.6458839163487, 454.66354897375703, 459.6322941646669, 464.9418822647169, 4055.1281474483126, 4115.855945041909, 4135.648469880034, 4145.005198752338, 4166.166766646683, 10681.412522311348, 10974.725631859268, 11049.0, 11056.889431105586, 11087.889121108847, 9084.40951338161, 9289.303302252223, 11055.281406708538, 11073.889261107286, 11092.001719845253, 7047.541909775849, 7820.882686759704, 8133.437967040481, 8285.461445005934, 8358.749237522885, 5057.0, 6022.0, 6042.425969532887, 6069.119977603134, 6216.098665693539, 9006.594703238501, 9940.155086817413, 10212.0, 10224.386536807815, 10247.436390998566, 8508.702195423131, 9804.509774511389, 9970.601175952881, 10327.277090603586, 10483.528241229316, 6990.545614535039, 7231.49379543448, 7363.190049094703, 7373.041504604367, 7388.519746216479, 7478.663460144197, 8459.069502354612, 8490.957545212234, 8533.74398768013, 8543.444676096035, 7012.228654848064, 7113.8577228454105, 7119.928800712134, 7160.391366733677, 7269.236730143259, 7359.411247100326, 7472.40220782347, 7475.289847464483, 7514.286142816423, 7528.0, 7142.071530700976, 7228.421726261991, 7243.855122897407, 7264.818379540554, 7281.543691261663, 5089.338386009795, 5098.2352647103235, 5149.9742501287255, 5180.818671346485, 5230.084735171254, 5092.287079808756, 5102.540771330449, 5134.409542902465, 5215.504527069922, 5360.195970604441], "value": 4504.203995439357, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [257.59171712835155, 302.2911273064664, 311.9067667824276, 315.63544106556935, 317.44130330618106, 5388.272583201267, 5457.645253058553, 5491.368492623349, 5650.350209725878, 5658.773649054038, 4858.4898585648525, 4911.495137479884, 5516.503514683678, 5617.494425501704, 5671.376148623648, 3590.5943018177754, 4088.632023117919, 4170.456021826683, 4186.120914607936, 4240.427542281784, 4088.4276201331836, 4163.413232759261, 4207.758711180194, 4257.978710106445, 4285.185814695198, 4179.456670632813, 4200.495940487146, 4200.831966721327, 4218.713292445803, 4226.746395216282, 3718.233838926515, 4192.155451601286, 4206.3690446432975, 4213.662906967435, 4253.936190957138, 3099.3491366812996, 3612.674859262679, 3645.505342809435, 3654.4701018352457, 3667.0465678923406, 5349.090654588729, 5448.291722076145, 5457.863553411157, 5507.697076660782, 5513.531349835269, 4611.792469338888, 4809.326694262806, 4820.818899369677, 4859.343988561534, 4901.362822833044, 4213.9578604213875, 4675.976620116911, 5746.678263999262, 5929.703514824241, 5958.433948774903, 3690.892732180362, 3952.980235098835, 4000.219902143547, 4004.4593979812644, 4028.5165780106577, 5468.507834294893, 5488.4785945335125, 6095.359987201368, 6231.597890474607, 6331.715072821688, 3802.391617341212, 3911.9486800295813, 4062.8171732272117, 4068.816903239361, 4077.388391741203, 3748.8125593720206, 3985.501812273466, 3991.0244429007826, 4069.0, 4134.896627584334, 4117.91764164721, 4711.670183087151, 4732.337472753818, 4737.597304229179, 4788.95211047892, 4998.02538504988, 5936.782959493294, 5936.8126374725225, 5981.222441082718, 5981.581289309794, 1312.2126723965544, 1359.3483917040842, 1376.8898488120926, 1382.2466755618211, 1384.9099808512415, 814.7637185216221, 886.7694399456059, 889.3797593442939, 917.3486824354783, 920.3925409229876, 5413.750206088202, 5464.617476776667, 5495.642783219078, 5516.227728118067, 5518.33779946401, 5976.207137858625, 5984.379450432512, 5986.5809393342915, 5995.46040856325, 6025.698715064229, 4558.840440584564, 4763.7141771493125, 5222.190560463135, 5508.724563771795, 5527.766256739772, 2317.43222910388, 2378.5956387413835, 2654.402759379163, 2669.251640175688, 2683.5303821831494, 4598.908021839545, 4749.382580264543, 5241.371035475768, 5249.737513124329, 5263.236830659533, 4408.53710360414, 4719.5966292862395, 5103.566196873233, 5137.845864624067, 5172.689638621695, 4642.353858300736, 5191.740412979336, 5212.687238765686, 5222.7127507987425, 5257.08001099806, 4486.878280429893, 4724.787384567634, 5058.974705126451, 5090.745462726923, 5102.2498463629945, 4409.955900440955, 4449.399331090391, 4488.932666009947, 4999.950000499948, 5024.648274620888, 4720.740359280273, 5099.311592934906, 5207.140821764518, 5228.581713462838, 5247.2129180623215, 2871.8851245949927, 3203.615566132079, 3432.5880894292845, 3474.3844112487814, 3482.21650128719, 4692.296155576691, 4761.952380476151, 5032.421271553818, 5047.6214283929585, 5053.469385714594, 4444.888877778081, 4660.557247061523, 4885.291632713165, 4916.205584961534, 4927.581155601814, 4229.746215227096, 4392.66023862725, 4434.37918691377, 4662.300654901656, 4932.482089380564, 4825.686330388514, 4854.466008738966, 4860.927086093782, 5176.559992400688, 5785.82642520725, 5370.892582148257, 5669.667628107474, 5910.404190868528, 5933.757363485129, 5940.831596467172, 5486.1770734388565, 5810.448007439287, 5823.883522329615, 5829.8251052468495, 5888.852778680396], "value": 4020.753651531448, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [708.585477495665, 708.7023450150937, 716.3552802477769, 774.0479210570998, 821.6918655504186, 15364.154971476579, 16231.756523652126, 16239.75640365394, 16277.755833662504, 16286.592835179126, 12846.48614055439, 14485.493007744732, 14613.488527901525, 14619.342129604167, 14627.780583291233, 653.5261935097064, 691.778630838132, 807.9232472915064, 825.3314814999869, 850.0861573808181, 856.9357298202628, 858.9613467393982, 859.188067276424, 860.109786371106, 863.9265662418702, 894.2935081285776, 901.923336516397, 904.0191392339287, 908.8727578139033, 910.1035480052143, 892.1346294094718, 902.1294450854891, 903.7695387676133, 904.0642934562761, 906.9455832650062, 666.6500087454125, 677.6476232359146, 678.1895634716516, 678.4131726056975, 681.2982627893277, 14819.40722371104, 14868.70262594742, 15014.174220417872, 15054.0, 15076.849231507655, 14883.404663813435, 14910.478133265393, 14945.0, 14946.850531494654, 15008.0, 11983.700407489796, 12165.0, 12185.939070304681, 12331.321777302244, 12511.874881251162, 3747.362948298796, 3821.847126114952, 3840.8463661453507, 3942.1918506706056, 3963.029057880809, 112467.0, 113189.0, 113312.43343783228, 113555.0, 117345.82654173435, 11394.202405831513, 11400.885991139983, 11425.657230283105, 11603.071754259809, 11746.353950532803, 19778.0, 23377.0, 23493.17773877906, 23580.288266849187, 23692.407689807547, 8145.551994640352, 8248.587570621445, 8252.257296843312, 8351.791205219919, 8361.581920903931, 4519.7740112994215, 4545.2954792007295, 4549.954500455019, 4555.886102847389, 4556.384888040138, 3573.5711714594413, 3690.4833323334756, 3722.3113723961155, 3736.1967177057063, 3744.9063773405883, 653.738504598155, 667.7228949985798, 671.5232185148501, 681.1111499493209, 683.3815397065664, 581.2472847662287, 594.878049999749, 648.73726140913, 654.3564001434247, 673.7810211681223, 9544.952275238718, 9569.090936361035, 9626.0, 9768.706938791847, 9786.804263914682, 515.3352175693389, 639.7792761497369, 647.090837373491, 658.1040241768645, 675.97927130034, 4464.441944756905, 4718.103560323528, 4753.667243293005, 4782.258749893772, 4842.418909730784, 107490.46254768677, 147421.26289368485, 150569.24715376354, 166496.0, 171010.0, 132162.0, 134319.0, 135321.0, 138196.0, 138232.0, 108441.0, 108445.45777271064, 119198.40400798114, 122097.0, 122893.38553307355, 7994.61104735302, 10007.077911471684, 10039.899601003897, 10052.497375131361, 10164.0, 47586.04827903353, 54253.45746542484, 56633.0, 60419.95800419923, 61048.69475652593, 78596.82104768319, 80361.0, 81414.77877831718, 88370.0, 94056.0, 9572.521373931415, 10642.8403573948, 12929.288889111189, 12949.935250324064, 13433.328333583477, 14668.339924703201, 14884.032537885003, 14995.0, 15208.771868421762, 15229.695406091594, 14035.649108772363, 14152.78770818459, 14171.645708856948, 14532.273386330853, 14596.85403145955, 11903.821442678194, 13836.654083647989, 14047.946404019534, 14479.92760036193, 14561.781573276621, 13773.931130344285, 13849.79225311601, 13972.510962116683, 13996.860031399556, 14431.3505892233, 11200.327980321206, 11205.887941120485, 11537.01935335506, 11840.407979601157, 11962.10284228669, 9481.573329200064, 10380.532876020447, 11214.95327102775, 11667.0, 11708.590199342982], "value": 7914.183320644381, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1621.8999999999999, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 116.0, 105.0, 155.0, 170.0, 161.0, 118.0, 117.0, 116.0, 115.0], "value": 127.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 113.0, 139.0, 189.0, 142.0, 136.0, 129.0, 93.0, 160.0, 131.0], "value": 137.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [200.0, 203.0, 238.0, 200.0, 197.0, 227.0, 195.0, 276.0, 267.0, 201.0], "value": 220.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 87.0, 75.0, 143.0, 60.0, 59.0, 58.0, 63.0, 135.0, 59.0], "value": 80.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 73.0, 132.0, 100.0, 81.0, 74.0, 117.0, 70.0, 75.0, 116.0], "value": 90.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 86.0, 103.0, 131.0, 108.0, 85.0, 111.0, 123.0, 136.0, 94.0], "value": 111.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 95.0, 115.0, 136.0, 95.0, 95.0, 95.0, 96.0, 94.0], "value": 101.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 93.0, 92.0, 105.0, 156.0, 118.0, 92.0, 91.0, 92.0, 91.0], "value": 102.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 59.0, 59.0, 78.0, 86.0, 86.0, 88.0, 91.0, 57.0, 57.0], "value": 71.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 69.0, 76.0, 71.0, 82.0, 76.0, 73.0, 69.0, 69.0, 72.0], "value": 72.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 94.0, 85.0, 83.0, 89.0, 88.0, 107.0, 116.0, 109.0, 79.0], "value": 93.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 159.0, 157.0, 154.0, 156.0, 153.0, 162.0, 160.0, 174.0, 144.0], "value": 156.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 213.0, 236.0, 230.0, 171.0, 170.0, 167.0, 168.0, 168.0, 173.0], "value": 186.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 70.0, 68.0, 68.0, 68.0, 69.0, 82.0, 67.0, 67.0, 69.0], "value": 69.8, "unit": "score"}]}]} 11:11:52 INFO - Return code: 0 11:11:52 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:11:52 ERROR - # TBPL SUCCESS # 11:11:52 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 11:11:52 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 11:11:52 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 11:11:52 INFO - 2016-08-22 11:11:52.651 screenresolution[1671:10584] starting screenresolution argv=screenresolution get 11:11:52 INFO - 2016-08-22 11:11:52.654 screenresolution[1671:10584] Display 0: 1600x1200x32@60 11:11:52 INFO - 2016-08-22 11:11:52.660 screenresolution[1672:10587] starting screenresolution argv=screenresolution list 11:11:52 INFO - Available Modes on Display 0 11:11:52 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 11:11:52 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 11:11:52 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 11:11:52 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 11:11:52 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 11:11:52 INFO - Intel Iris: 11:11:52 INFO - Chipset Model: Intel Iris 11:11:52 INFO - Type: GPU 11:11:52 INFO - Bus: Built-In 11:11:52 INFO - VRAM (Dynamic, Max): 1536 MB 11:11:52 INFO - Vendor: Intel (0x8086) 11:11:52 INFO - Device ID: 0x0a2e 11:11:52 INFO - Revision ID: 0x0009 11:11:52 INFO - Displays: 11:11:52 INFO - Display: 11:11:52 INFO - Resolution: 1600 x 1200 @ 60 Hz 11:11:52 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 11:11:52 INFO - Display Serial Number: 1600x1200 60 11:11:52 INFO - Main Display: Yes 11:11:52 INFO - Mirror: Off 11:11:52 INFO - Online: Yes 11:11:52 INFO - Rotation: Supported 11:11:52 INFO - Return code: 0 11:11:52 INFO - Running post-action listener: _resource_record_post_action 11:11:52 INFO - [mozharness: 2016-08-22 18:11:52.895404Z] Finished run-tests step (success) 11:11:52 INFO - Running post-run listener: _resource_record_post_run 11:11:52 INFO - Total resource usage - Wall time: 1210s; CPU: 55.0%; Read bytes: 37852160; Write bytes: 707174912; Read time: 392; Write time: 2041 11:11:52 INFO - TinderboxPrint: CPU usage
54.7% 11:11:52 INFO - TinderboxPrint: I/O read bytes / time
37,852,160 / 392 11:11:52 INFO - TinderboxPrint: I/O write bytes / time
707,174,912 / 2,041 11:11:52 INFO - TinderboxPrint: CPU idle
2,194.8 (45.3%) 11:11:52 INFO - TinderboxPrint: CPU system
978.4 (20.2%) 11:11:52 INFO - TinderboxPrint: CPU user
1,668.5 (34.5%) 11:11:52 INFO - TinderboxPrint: Swap in / out
444,436,480 / 0 11:11:52 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 397789696; Write bytes: 392861184; Read time: 29666; Write time: 779 11:11:52 INFO - run-tests - Wall time: 1176s; CPU: 55.0%; Read bytes: 35845120; Write bytes: 296348672; Read time: 370; Write time: 1205 11:11:53 INFO - Running post-run listener: _upload_blobber_files 11:11:53 INFO - Blob upload gear active. 11:11:53 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:11:53 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 11:11:53 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'] 11:11:53 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 11:11:53 INFO - (blobuploader) - INFO - Open directory for files ... 11:11:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 11:11:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:11:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:11:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 11:11:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:11:54 INFO - (blobuploader) - INFO - Done attempting. 11:11:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 11:11:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:11:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:11:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 11:11:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:11:55 INFO - (blobuploader) - INFO - Done attempting. 11:11:55 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:11:55 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:11:55 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:11:58 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:11:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:11:58 INFO - (blobuploader) - INFO - Done attempting. 11:11:58 INFO - (blobuploader) - INFO - Iteration through files over. 11:11:58 INFO - Return code: 0 11:11:58 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:11:58 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:11:58 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/748b5a597631d0b84d009d8b69a35afa3398edbbd4261524ce9a6dd548dcbabc665829cfd3b03325860b23c0fa8f4162e3accb0a0a8fa6b959bc384150dbbdcd", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e5b348f981aaa41380b570f5d0fa677a3808a724a20abe12fd7c16131c4755264324add8add857d3082e411f3a2f2d3e6a7abd55ce9a4f4388ef4d1736122545", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4e3947351a9bec4254b7b821d5adab46a2c47ae2fc558904fa8a49815428e1760913bbc280e006390287d18cb597ef523777435cbbe8fe7f21c860ada72df0d2"} 11:11:58 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:11:58 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:11:58 INFO - Contents: 11:11:58 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/748b5a597631d0b84d009d8b69a35afa3398edbbd4261524ce9a6dd548dcbabc665829cfd3b03325860b23c0fa8f4162e3accb0a0a8fa6b959bc384150dbbdcd", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e5b348f981aaa41380b570f5d0fa677a3808a724a20abe12fd7c16131c4755264324add8add857d3082e411f3a2f2d3e6a7abd55ce9a4f4388ef4d1736122545", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4e3947351a9bec4254b7b821d5adab46a2c47ae2fc558904fa8a49815428e1760913bbc280e006390287d18cb597ef523777435cbbe8fe7f21c860ada72df0d2"} 11:11:58 INFO - Running post-run listener: copy_logs_to_upload_dir 11:11:58 INFO - Copying logs to upload dir... 11:11:58 INFO - mkdir: /builds/slave/test/build/upload/logs 11:11:58 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1272.718013 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 12 secs) (at 2016-08-22 11:11:58.604975) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-22 11:11:58.608013) ========= 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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners TMPDIR=/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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/748b5a597631d0b84d009d8b69a35afa3398edbbd4261524ce9a6dd548dcbabc665829cfd3b03325860b23c0fa8f4162e3accb0a0a8fa6b959bc384150dbbdcd", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e5b348f981aaa41380b570f5d0fa677a3808a724a20abe12fd7c16131c4755264324add8add857d3082e411f3a2f2d3e6a7abd55ce9a4f4388ef4d1736122545", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4e3947351a9bec4254b7b821d5adab46a2c47ae2fc558904fa8a49815428e1760913bbc280e006390287d18cb597ef523777435cbbe8fe7f21c860ada72df0d2"} build_url:https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011094 build_url: 'https://queue.taskcluster.net/v1/task/RKOUVijZRF-ukD7mvmYWAQ/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/748b5a597631d0b84d009d8b69a35afa3398edbbd4261524ce9a6dd548dcbabc665829cfd3b03325860b23c0fa8f4162e3accb0a0a8fa6b959bc384150dbbdcd", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e5b348f981aaa41380b570f5d0fa677a3808a724a20abe12fd7c16131c4755264324add8add857d3082e411f3a2f2d3e6a7abd55ce9a4f4388ef4d1736122545", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4e3947351a9bec4254b7b821d5adab46a2c47ae2fc558904fa8a49815428e1760913bbc280e006390287d18cb597ef523777435cbbe8fe7f21c860ada72df0d2"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-22 11:11:58.641005) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 11:11:58.641288) ========= 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.DD09b5bCOW/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.pnzdDMa6IJ/Listeners TMPDIR=/var/folders/ll/nfr6cy655632107dm4rhqyxr00000w/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.005014 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 11:11:58.689150) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-22 11:11:58.689434) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-22 11:11:58.689732) ========= ========= Total master_lag: 0.17 =========