builder: autoland_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0256 starttime: 1471533589.28 results: success (0) buildid: 20160818060054 builduid: 4986dd8cf88d41c9b68b9c892374df39 revision: f0077112f013b3b8e92c5aff62638cc65d963437 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.279640) ========= master: http://buildbot-master134.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.280121) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.280430) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.351142) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.351601) ========= 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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners TMPDIR=/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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-18 08:19:49-- 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% 22.0M=0.001s 2016-08-18 08:19:49 (22.0 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.131552 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.506766) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.507156) ========= 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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners TMPDIR=/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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.026300 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.555990) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:49.556381) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev f0077112f013b3b8e92c5aff62638cc65d963437 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev f0077112f013b3b8e92c5aff62638cc65d963437 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.jEw4pZcUIn/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.bTMWr9IRDL/Listeners TMPDIR=/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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-18 08:19:49,639 truncating revision to first 12 chars 2016-08-18 08:19:49,639 Setting DEBUG logging. 2016-08-18 08:19:49,639 attempt 1/10 2016-08-18 08:19:49,639 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/f0077112f013?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-18 08:19:50,293 unpacking tar archive at: autoland-f0077112f013/testing/mozharness/ program finished with exit code 0 elapsedTime=0.916328 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:50.495942) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:50.496290) ========= script_repo_revision: f0077112f013b3b8e92c5aff62638cc65d963437 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:50.496717) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:50.496980) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-18 08:19:50.515761) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2016-08-18 08:19:50.516176) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 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', 'Autoland', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.jEw4pZcUIn/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.bTMWr9IRDL/Listeners TMPDIR=/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:19:50 INFO - MultiFileLogger online at 20160818 08:19:50 in /builds/slave/test 08:19:50 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 08:19:50 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:19:50 INFO - {'append_to_log': False, 08:19:50 INFO - 'base_work_dir': '/builds/slave/test', 08:19:50 INFO - 'blob_upload_branch': 'Autoland', 08:19:50 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:19:50 INFO - 'branch': 'Autoland', 08:19:50 INFO - 'buildbot_json_path': 'buildprops.json', 08:19:50 INFO - 'config_files': ('talos/mac_config.py',), 08:19:50 INFO - 'default_actions': ('clobber', 08:19:50 INFO - 'read-buildbot-config', 08:19:50 INFO - 'download-and-extract', 08:19:50 INFO - 'populate-webroot', 08:19:50 INFO - 'create-virtualenv', 08:19:50 INFO - 'install', 08:19:50 INFO - 'run-tests'), 08:19:50 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:19:50 INFO - 'download_minidump_stackwalk': True, 08:19:50 INFO - 'download_symbols': 'ondemand', 08:19:50 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:19:50 INFO - 'tooltool.py': '/tools/tooltool.py', 08:19:50 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:19:50 INFO - '/tools/misc-python/virtualenv.py')}, 08:19:50 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:19:50 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:19:50 INFO - 'installer_path': 'installer.exe', 08:19:50 INFO - 'log_level': 'info', 08:19:50 INFO - 'log_name': 'talos', 08:19:50 INFO - 'log_to_console': True, 08:19:50 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 08:19:50 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 08:19:50 INFO - 'opt_config_files': (), 08:19:50 INFO - 'pip_index': False, 08:19:50 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:19:50 INFO - 'cmd': ('bash', 08:19:50 INFO - '-c', 08:19:50 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:19:50 INFO - 'enabled': True, 08:19:50 INFO - 'halt_on_failure': False, 08:19:50 INFO - 'name': 'check_screen_resolution'},), 08:19:50 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:19:50 INFO - 'cmd': ('bash', 08:19:50 INFO - '-c', 08:19:50 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:19:50 INFO - 'enabled': True, 08:19:50 INFO - 'halt_on_failure': False, 08:19:50 INFO - 'name': 'check_screen_resolution'},), 08:19:50 INFO - 'run_cmd_checks_enabled': True, 08:19:50 INFO - 'sps_profile': False, 08:19:50 INFO - 'sps_profile_interval': 0, 08:19:50 INFO - 'suite': 'dromaeojs-e10s', 08:19:50 INFO - 'system_bits': '32', 08:19:50 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:19:50 INFO - 'title': 't-yosemite-r7-0256', 08:19:50 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:19:50 INFO - 'use_talos_json': True, 08:19:50 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:19:50 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:19:50 INFO - 'work_dir': 'build'} 08:19:50 INFO - [mozharness: 2016-08-18 15:19:50.714943Z] Running clobber step. 08:19:50 INFO - Running pre-action listener: _resource_record_pre_action 08:19:50 INFO - Running main action method: clobber 08:19:50 INFO - rmtree: /builds/slave/test/build 08:19:50 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:19:52 INFO - Running post-action listener: _resource_record_post_action 08:19:52 INFO - [mozharness: 2016-08-18 15:19:52.762432Z] Finished clobber step (success) 08:19:52 INFO - [mozharness: 2016-08-18 15:19:52.762572Z] Running read-buildbot-config step. 08:19:52 INFO - Running pre-action listener: _resource_record_pre_action 08:19:52 INFO - Running main action method: read_buildbot_config 08:19:52 INFO - Using buildbot properties: 08:19:52 INFO - { 08:19:52 INFO - "project": "", 08:19:52 INFO - "product": "firefox", 08:19:52 INFO - "script_repo_revision": "production", 08:19:52 INFO - "builddir": "autoland_yosemite_r7_test-dromaeojs-e10s", 08:19:52 INFO - "repository": "", 08:19:52 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 autoland talos dromaeojs-e10s", 08:19:52 INFO - "buildid": "20160818060054", 08:19:52 INFO - "pgo_build": "False", 08:19:52 INFO - "basedir": "/builds/slave/test", 08:19:52 INFO - "buildnumber": 129, 08:19:52 INFO - "slavename": "t-yosemite-r7-0256", 08:19:52 INFO - "master": "http://buildbot-master134.bb.releng.scl3.mozilla.com:8201/", 08:19:52 INFO - "platform": "yosemite_r7", 08:19:52 INFO - "scheduler": "tests-autoland-macosx64-talos-7-3600", 08:19:52 INFO - "branch": "autoland", 08:19:52 INFO - "repo_path": "integration/autoland", 08:19:52 INFO - "revision": "f0077112f013b3b8e92c5aff62638cc65d963437", 08:19:52 INFO - "stage_platform": "macosx64", 08:19:52 INFO - "builduid": "4986dd8cf88d41c9b68b9c892374df39", 08:19:52 INFO - "slavebuilddir": "test" 08:19:52 INFO - } 08:19:52 INFO - Found installer url https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg. 08:19:52 INFO - Running post-action listener: _resource_record_post_action 08:19:52 INFO - [mozharness: 2016-08-18 15:19:52.768499Z] Finished read-buildbot-config step (success) 08:19:52 INFO - [mozharness: 2016-08-18 15:19:52.768769Z] Running download-and-extract step. 08:19:52 INFO - Running pre-action listener: _resource_record_pre_action 08:19:52 INFO - Running main action method: download_and_extract 08:19:52 INFO - mkdir: /builds/slave/test/build/tests 08:19:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:19:52 INFO - trying https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json 08:19:52 INFO - Downloading https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:19:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:19:54 INFO - Downloaded 1199 bytes. 08:19:54 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 08:19:54 INFO - Using the following test package requirements: 08:19:54 INFO - {u'common': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 08:19:54 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 08:19:54 INFO - u'firefox-51.0a1.en-US.mac.cppunittest.tests.zip'], 08:19:54 INFO - u'gtest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 08:19:54 INFO - u'firefox-51.0a1.en-US.mac.gtest.tests.zip'], 08:19:54 INFO - u'jittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 08:19:54 INFO - u'jsshell-mac.zip'], 08:19:54 INFO - u'mochitest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 08:19:54 INFO - u'firefox-51.0a1.en-US.mac.mochitest.tests.zip'], 08:19:54 INFO - u'mozbase': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 08:19:54 INFO - u'reftest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 08:19:54 INFO - u'firefox-51.0a1.en-US.mac.reftest.tests.zip'], 08:19:54 INFO - u'talos': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 08:19:54 INFO - u'firefox-51.0a1.en-US.mac.talos.tests.zip'], 08:19:54 INFO - u'web-platform': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 08:19:54 INFO - u'firefox-51.0a1.en-US.mac.web-platform.tests.zip'], 08:19:54 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 08:19:54 INFO - u'firefox-51.0a1.en-US.mac.xpcshell.tests.zip']} 08:19:54 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip'] for test suite category: common 08:19:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:19:54 INFO - trying https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 08:19:54 INFO - Downloading https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:19:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:19:54 INFO - Downloaded 16339533 bytes. 08:19:54 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 08:20:01 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 08:20:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:01 INFO - trying https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 08:20:01 INFO - Downloading https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:20:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:20:02 INFO - Downloaded 16339533 bytes. 08:20:02 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 08:20:09 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')]} 08:20:09 INFO - trying https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip 08:20:09 INFO - Downloading https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:20:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:20:10 INFO - Downloaded 14413981 bytes. 08:20:10 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/tests 08:20:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:10 INFO - trying https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 08:20:10 INFO - Downloading https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg 08:20:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/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 08:20:13 INFO - Downloaded 111265524 bytes. 08:20:13 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 08:20:13 INFO - mkdir: /builds/slave/test/properties 08:20:13 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:20:13 INFO - Writing to file /builds/slave/test/properties/build_url 08:20:13 INFO - Contents: 08:20:13 INFO - build_url:https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 08:20:14 INFO - Running post-action listener: _resource_record_post_action 08:20:14 INFO - Running post-action listener: set_extra_try_arguments 08:20:14 INFO - [mozharness: 2016-08-18 15:20:14.141317Z] Finished download-and-extract step (success) 08:20:14 INFO - [mozharness: 2016-08-18 15:20:14.141436Z] Running populate-webroot step. 08:20:14 INFO - Running pre-action listener: _resource_record_pre_action 08:20:14 INFO - Running main action method: populate_webroot 08:20:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:20:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:20:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:20:14 INFO - '--tppagecycles', 08:20:14 INFO - '7'], 08:20:14 INFO - 'tests': ['tsvgm']}}, 08:20:14 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:20:14 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:20:14 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:20:14 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:20:14 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:20:14 INFO - 'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:20:14 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:20:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:20:14 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:20:14 INFO - 'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['damp', 'tps']}, 08:20:14 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:20:14 INFO - 'tests': ['damp', 'tps']}, 08:20:14 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['dromaeo_dom']}, 08:20:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:20:14 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['basic_compositor_video']}, 08:20:14 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:20:14 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['a11yr', 08:20:14 INFO - 'ts_paint', 08:20:14 INFO - 'tpaint', 08:20:14 INFO - 'sessionrestore', 08:20:14 INFO - 'sessionrestore_no_auto_restore', 08:20:14 INFO - 'tabpaint']}, 08:20:14 INFO - 'other-e10s': {'tests': ['a11yr', 08:20:14 INFO - 'ts_paint', 08:20:14 INFO - 'tpaint', 08:20:14 INFO - 'sessionrestore', 08:20:14 INFO - 'sessionrestore_no_auto_restore', 08:20:14 INFO - 'tabpaint']}, 08:20:14 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:20:14 INFO - 'ts_paint', 08:20:14 INFO - 'tpaint', 08:20:14 INFO - 'sessionrestore', 08:20:14 INFO - 'sessionrestore_no_auto_restore', 08:20:14 INFO - 'tabpaint']}, 08:20:14 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:20:14 INFO - 'ts_paint', 08:20:14 INFO - 'tpaint', 08:20:14 INFO - 'sessionrestore', 08:20:14 INFO - 'sessionrestore_no_auto_restore', 08:20:14 INFO - 'tabpaint']}, 08:20:14 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['a11yr', 08:20:14 INFO - 'ts_paint', 08:20:14 INFO - 'tpaint', 08:20:14 INFO - 'sessionrestore', 08:20:14 INFO - 'sessionrestore_no_auto_restore', 08:20:14 INFO - 'tabpaint']}, 08:20:14 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['a11yr', 08:20:14 INFO - 'ts_paint', 08:20:14 INFO - 'tpaint', 08:20:14 INFO - 'sessionrestore', 08:20:14 INFO - 'sessionrestore_no_auto_restore', 08:20:14 INFO - 'tabpaint']}, 08:20:14 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['tsvgx', 08:20:14 INFO - 'tsvgr_opacity', 08:20:14 INFO - 'tart', 08:20:14 INFO - 'tscrollx', 08:20:14 INFO - 'cart']}, 08:20:14 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:20:14 INFO - 'tsvgr_opacity', 08:20:14 INFO - 'tart', 08:20:14 INFO - 'tscrollx', 08:20:14 INFO - 'cart']}, 08:20:14 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:20:14 INFO - 'talos_options': ['--disable-e10s'], 08:20:14 INFO - 'tests': ['tp5o']}, 08:20:14 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:20:14 INFO - 'tests': ['tp5o']}, 08:20:14 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:20:14 INFO - 'talos_options': ['--disable-e10s', 08:20:14 INFO - '--xperf_path', 08:20:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:20:14 INFO - 'tests': ['tp5n']}, 08:20:14 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:20:14 INFO - 'talos_options': ['--xperf_path', 08:20:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:20:14 INFO - 'tests': ['tp5n']}}, 08:20:14 INFO - 'talos.zip': {'path': '', 08:20:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:20:14 INFO - Running post-action listener: _resource_record_post_action 08:20:14 INFO - [mozharness: 2016-08-18 15:20:14.159970Z] Finished populate-webroot step (success) 08:20:14 INFO - [mozharness: 2016-08-18 15:20:14.160081Z] Running create-virtualenv step. 08:20:14 INFO - Running pre-action listener: _resource_record_pre_action 08:20:14 INFO - Running main action method: create_virtualenv 08:20:14 INFO - Creating virtualenv /builds/slave/test/build/venv 08:20:14 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 08:20:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:20:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:20:14 INFO - Using real prefix '/tools/python27' 08:20:14 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:20:15 INFO - Installing distribute.............................................................................................................................................................................................done. 08:20:17 INFO - Installing pip.................done. 08:20:17 INFO - Return code: 0 08:20:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:20:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:17 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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20:17 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 08:20:17 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 08:20:17 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:17 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:17 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:17 INFO - 'HOME': '/Users/cltbld', 08:20:17 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:17 INFO - 'LOGNAME': 'cltbld', 08:20:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:17 INFO - 'MOZ_NO_REMOTE': '1', 08:20:17 INFO - 'NO_EM_RESTART': '1', 08:20:17 INFO - 'PAGER': '/bin/cat', 08:20:17 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:17 INFO - 'PWD': '/builds/slave/test', 08:20:17 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:17 INFO - 'SHELL': '/bin/bash', 08:20:17 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:17 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:17 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:17 INFO - 'USER': 'cltbld', 08:20:17 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:17 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:17 INFO - 'XPC_FLAGS': '0x0', 08:20:17 INFO - 'XPC_SERVICE_NAME': '0', 08:20:17 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:18 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 08:20:18 INFO - Cleaning up... 08:20:18 INFO - Return code: 0 08:20:18 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:20:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 08:20:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 08:20:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:18 INFO - 'HOME': '/Users/cltbld', 08:20:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:18 INFO - 'LOGNAME': 'cltbld', 08:20:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:18 INFO - 'MOZ_NO_REMOTE': '1', 08:20:18 INFO - 'NO_EM_RESTART': '1', 08:20:18 INFO - 'PAGER': '/bin/cat', 08:20:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:18 INFO - 'PWD': '/builds/slave/test', 08:20:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:18 INFO - 'SHELL': '/bin/bash', 08:20:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:18 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:18 INFO - 'USER': 'cltbld', 08:20:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:18 INFO - 'XPC_FLAGS': '0x0', 08:20:18 INFO - 'XPC_SERVICE_NAME': '0', 08:20:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:18 INFO - Downloading/unpacking psutil>=3.1.1 08:20:18 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 08:20:18 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 08:20:18 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 08:20:18 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 08:20:18 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 08:20:18 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 08:20:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:20:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:20:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:20:21 INFO - Installing collected packages: psutil 08:20:21 INFO - Running setup.py install for psutil 08:20:21 INFO - building 'psutil._psutil_osx' extension 08:20:21 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 08:20:21 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 08:20:21 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 08:20:21 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 08:20:21 INFO - building 'psutil._psutil_posix' extension 08:20:21 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 08:20:21 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 08:20:21 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 08:20:21 INFO - ^ 08:20:21 INFO - 1 warning generated. 08:20:21 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 08:20:22 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:20:22 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:20:22 INFO - Successfully installed psutil 08:20:22 INFO - Cleaning up... 08:20:22 INFO - Return code: 0 08:20:22 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:20: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')]} 08:20:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20: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')]} 08:20:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 08:20: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 mozsystemmonitor==0.3 08:20:22 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:22 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:22 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:22 INFO - 'HOME': '/Users/cltbld', 08:20:22 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:22 INFO - 'LOGNAME': 'cltbld', 08:20:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:22 INFO - 'MOZ_NO_REMOTE': '1', 08:20:22 INFO - 'NO_EM_RESTART': '1', 08:20:22 INFO - 'PAGER': '/bin/cat', 08:20:22 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:22 INFO - 'PWD': '/builds/slave/test', 08:20:22 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:22 INFO - 'SHELL': '/bin/bash', 08:20:22 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:22 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:22 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:22 INFO - 'USER': 'cltbld', 08:20:22 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:22 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:22 INFO - 'XPC_FLAGS': '0x0', 08:20:22 INFO - 'XPC_SERVICE_NAME': '0', 08:20:22 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:22 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:20: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 08:20: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 08:20: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 08:20: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 08:20: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 08:20: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 08:20:24 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:20:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:20:25 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:20:25 INFO - Installing collected packages: mozsystemmonitor 08:20:25 INFO - Running setup.py install for mozsystemmonitor 08:20:25 INFO - Successfully installed mozsystemmonitor 08:20:25 INFO - Cleaning up... 08:20:25 INFO - Return code: 0 08:20:25 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:20: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')]} 08:20:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20: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')]} 08:20:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20: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', '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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 08:20: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 jsonschema==2.5.1 08:20:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:25 INFO - 'HOME': '/Users/cltbld', 08:20:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:25 INFO - 'LOGNAME': 'cltbld', 08:20:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:25 INFO - 'MOZ_NO_REMOTE': '1', 08:20:25 INFO - 'NO_EM_RESTART': '1', 08:20:25 INFO - 'PAGER': '/bin/cat', 08:20:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:25 INFO - 'PWD': '/builds/slave/test', 08:20:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:25 INFO - 'SHELL': '/bin/bash', 08:20:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:25 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:25 INFO - 'USER': 'cltbld', 08:20:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:25 INFO - 'XPC_FLAGS': '0x0', 08:20:25 INFO - 'XPC_SERVICE_NAME': '0', 08:20:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:25 INFO - Downloading/unpacking jsonschema==2.5.1 08:20:25 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 08:20:25 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 08:20:25 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 08:20:25 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 08:20:25 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 08:20:25 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 08:20:27 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:20:27 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:20:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:20:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:20:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:28 INFO - Downloading functools32-3.2.3-2.tar.gz 08:20:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:20:28 INFO - warning: no files found matching '*.txt' 08:20:28 INFO - no previously-included directories found matching 'build' 08:20:28 INFO - no previously-included directories found matching 'dist' 08:20:28 INFO - no previously-included directories found matching '.git*' 08:20:28 INFO - Installing collected packages: jsonschema, functools32 08:20:28 INFO - Running setup.py install for functools32 08:20:28 INFO - warning: no files found matching '*.txt' 08:20:28 INFO - no previously-included directories found matching 'build' 08:20:28 INFO - no previously-included directories found matching 'dist' 08:20:28 INFO - no previously-included directories found matching '.git*' 08:20:28 INFO - Successfully installed jsonschema functools32 08:20:28 INFO - Cleaning up... 08:20:28 INFO - Return code: 0 08:20:28 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:20:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 08:20:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 08:20:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:28 INFO - 'HOME': '/Users/cltbld', 08:20:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:28 INFO - 'LOGNAME': 'cltbld', 08:20:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:28 INFO - 'MOZ_NO_REMOTE': '1', 08:20:28 INFO - 'NO_EM_RESTART': '1', 08:20:28 INFO - 'PAGER': '/bin/cat', 08:20:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:28 INFO - 'PWD': '/builds/slave/test', 08:20:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:28 INFO - 'SHELL': '/bin/bash', 08:20:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:28 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:28 INFO - 'USER': 'cltbld', 08:20:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:28 INFO - 'XPC_FLAGS': '0x0', 08:20:28 INFO - 'XPC_SERVICE_NAME': '0', 08:20:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:28 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:20:28 INFO - Cleaning up... 08:20:28 INFO - Return code: 0 08:20:28 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:20:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:20:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:20:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:28 INFO - 'HOME': '/Users/cltbld', 08:20:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:28 INFO - 'LOGNAME': 'cltbld', 08:20:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:28 INFO - 'MOZ_NO_REMOTE': '1', 08:20:28 INFO - 'NO_EM_RESTART': '1', 08:20:28 INFO - 'PAGER': '/bin/cat', 08:20:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:28 INFO - 'PWD': '/builds/slave/test', 08:20:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:28 INFO - 'SHELL': '/bin/bash', 08:20:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:28 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:28 INFO - 'USER': 'cltbld', 08:20:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:28 INFO - 'XPC_FLAGS': '0x0', 08:20:28 INFO - 'XPC_SERVICE_NAME': '0', 08:20:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:29 INFO - Downloading/unpacking blobuploader==1.2.4 08:20: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 08:20: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 08:20: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 08:20: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 08:20: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 08:20: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 08:20:31 INFO - Downloading blobuploader-1.2.4.tar.gz 08:20:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:20:31 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:20:31 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 08:20:31 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 08:20:31 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 08:20:31 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 08:20:31 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 08:20:31 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 08:20:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:20:32 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:20:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:20:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:20:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:32 INFO - Downloading docopt-0.6.1.tar.gz 08:20:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:20:32 INFO - Installing collected packages: blobuploader, requests, docopt 08:20:32 INFO - Running setup.py install for blobuploader 08:20:33 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:20:33 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:20:33 INFO - Running setup.py install for requests 08:20:33 INFO - Running setup.py install for docopt 08:20:33 INFO - Successfully installed blobuploader requests docopt 08:20:33 INFO - Cleaning up... 08:20:33 INFO - Return code: 0 08:20:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:20:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:33 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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20:33 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 08:20:33 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 08:20:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:33 INFO - 'HOME': '/Users/cltbld', 08:20:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:33 INFO - 'LOGNAME': 'cltbld', 08:20:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:33 INFO - 'MOZ_NO_REMOTE': '1', 08:20:33 INFO - 'NO_EM_RESTART': '1', 08:20:33 INFO - 'PAGER': '/bin/cat', 08:20:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:33 INFO - 'PWD': '/builds/slave/test', 08:20:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:33 INFO - 'SHELL': '/bin/bash', 08:20:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:33 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:33 INFO - 'USER': 'cltbld', 08:20:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:33 INFO - 'XPC_FLAGS': '0x0', 08:20:33 INFO - 'XPC_SERVICE_NAME': '0', 08:20:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-eZdb2L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-H2WEGw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-K9JyFV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-EwbVvR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-fy07ja-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-JdeU5x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-0JGtp9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-1HggH3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:20:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:20:34 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-IpvEW2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:20:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:20:35 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-PmtAqk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:20:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:20:35 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-r0Reie-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:20:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:20:35 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-3QqB3s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:20:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:20:35 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-EQHIr_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:20:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:20:35 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-Fe33fr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:20:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:20:35 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-Td_x4m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:20:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:20:35 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-E5m_gw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:20:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:20:35 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-36LREr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:20:35 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:20:35 INFO - Running setup.py install for manifestparser 08:20:35 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:20:36 INFO - Running setup.py install for mozcrash 08:20:36 INFO - Running setup.py install for mozdebug 08:20:36 INFO - Running setup.py install for mozdevice 08:20:36 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:20:36 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:20:36 INFO - Running setup.py install for mozfile 08:20:36 INFO - Running setup.py install for mozhttpd 08:20:36 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:20:36 INFO - Running setup.py install for mozinfo 08:20:36 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:20:36 INFO - Running setup.py install for mozInstall 08:20:37 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Running setup.py install for mozleak 08:20:37 INFO - Running setup.py install for mozlog 08:20:37 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Running setup.py install for moznetwork 08:20:37 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Running setup.py install for mozprocess 08:20:37 INFO - Running setup.py install for mozprofile 08:20:37 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Running setup.py install for mozrunner 08:20:37 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:20:37 INFO - Running setup.py install for mozscreenshot 08:20:38 INFO - Running setup.py install for moztest 08:20:38 INFO - Running setup.py install for mozversion 08:20:38 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:20:38 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:20:38 INFO - Cleaning up... 08:20:38 INFO - Return code: 0 08:20:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:20:38 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')]} 08:20:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:38 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')]} 08:20:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:38 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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20:38 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 08:20:38 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 08:20:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:38 INFO - 'HOME': '/Users/cltbld', 08:20:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:38 INFO - 'LOGNAME': 'cltbld', 08:20:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:38 INFO - 'MOZ_NO_REMOTE': '1', 08:20:38 INFO - 'NO_EM_RESTART': '1', 08:20:38 INFO - 'PAGER': '/bin/cat', 08:20:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:38 INFO - 'PWD': '/builds/slave/test', 08:20:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:38 INFO - 'SHELL': '/bin/bash', 08:20:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:38 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:38 INFO - 'USER': 'cltbld', 08:20:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:38 INFO - 'XPC_FLAGS': '0x0', 08:20:38 INFO - 'XPC_SERVICE_NAME': '0', 08:20:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:20:38 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-XkZmDS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:20:38 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)) 08:20:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:20:38 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-0FE4NG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:20:38 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)) 08:20:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:20:38 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-q_79Jp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-b559oi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-mEQGMF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-fAXxes-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-txEWCY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-htYogG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-9fc22S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-dX3d8O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-R1JgZf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-i57ZkG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:20:39 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)) 08:20:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:20:39 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-CfRPO5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:20:40 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)) 08:20:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:20:40 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-69TARH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:20:40 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)) 08:20:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:20:40 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-rBtOLo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:20:40 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)) 08:20:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:20:40 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-eEtdKS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:20:40 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)) 08:20:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:20:40 INFO - Running setup.py (path:/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/pip-CxR9Pk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:20:40 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)) 08:20:40 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)) 08:20:40 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)) 08:20:40 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)) 08:20:40 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)) 08:20:40 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)) 08:20:40 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:20:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:20:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:20:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:42 INFO - Downloading blessings-1.6.tar.gz 08:20:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:20:43 INFO - Installing collected packages: blessings 08:20:43 INFO - Running setup.py install for blessings 08:20:43 INFO - Successfully installed blessings 08:20:43 INFO - Cleaning up... 08:20:43 INFO - Return code: 0 08:20:43 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:20:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:20:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:20:43 INFO - Reading from file tmpfile_stdout 08:20:43 INFO - Current package versions: 08:20:43 INFO - blessings == 1.6 08:20:43 INFO - blobuploader == 1.2.4 08:20:43 INFO - docopt == 0.6.1 08:20:43 INFO - functools32 == 3.2.3-2 08:20:43 INFO - jsonschema == 2.5.1 08:20:43 INFO - manifestparser == 1.1 08:20:43 INFO - mozInstall == 1.12 08:20:43 INFO - mozcrash == 0.17 08:20:43 INFO - mozdebug == 0.1 08:20:43 INFO - mozdevice == 0.48 08:20:43 INFO - mozfile == 1.2 08:20:43 INFO - mozhttpd == 0.7 08:20:43 INFO - mozinfo == 0.9 08:20:43 INFO - mozleak == 0.1 08:20:43 INFO - mozlog == 3.3 08:20:43 INFO - moznetwork == 0.27 08:20:43 INFO - mozprocess == 0.23 08:20:43 INFO - mozprofile == 0.28 08:20:43 INFO - mozrunner == 6.12 08:20:43 INFO - mozscreenshot == 0.1 08:20:43 INFO - mozsystemmonitor == 0.3 08:20:43 INFO - moztest == 0.7 08:20:43 INFO - mozversion == 1.4 08:20:43 INFO - psutil == 3.1.1 08:20:43 INFO - requests == 1.2.3 08:20:43 INFO - wsgiref == 0.1.2 08:20:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:20:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:43 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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20:43 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 08:20:43 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 08:20:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:43 INFO - 'HOME': '/Users/cltbld', 08:20:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:43 INFO - 'LOGNAME': 'cltbld', 08:20:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:43 INFO - 'MOZ_NO_REMOTE': '1', 08:20:43 INFO - 'NO_EM_RESTART': '1', 08:20:43 INFO - 'PAGER': '/bin/cat', 08:20:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:43 INFO - 'PWD': '/builds/slave/test', 08:20:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:43 INFO - 'SHELL': '/bin/bash', 08:20:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:43 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:43 INFO - 'USER': 'cltbld', 08:20:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:43 INFO - 'XPC_FLAGS': '0x0', 08:20:43 INFO - 'XPC_SERVICE_NAME': '0', 08:20:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 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)) 08:20:43 INFO - Cleaning up... 08:20:43 INFO - Return code: 0 08:20:43 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:20:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:20:43 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 0x10c5cfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c664618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f84b1d71d80>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, '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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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 08:20:43 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 08:20:43 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 08:20:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:20:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:20:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:20:43 INFO - 'HOME': '/Users/cltbld', 08:20:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:20:43 INFO - 'LOGNAME': 'cltbld', 08:20:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:43 INFO - 'MOZ_NO_REMOTE': '1', 08:20:43 INFO - 'NO_EM_RESTART': '1', 08:20:43 INFO - 'PAGER': '/bin/cat', 08:20:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:20:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:43 INFO - 'PWD': '/builds/slave/test', 08:20:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:20:43 INFO - 'SHELL': '/bin/bash', 08:20:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:20:43 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:20:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:20:43 INFO - 'USER': 'cltbld', 08:20:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:20:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:20:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:43 INFO - 'XPC_FLAGS': '0x0', 08:20:43 INFO - 'XPC_SERVICE_NAME': '0', 08:20:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:20:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:44 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:20:44 INFO - Cleaning up... 08:20:44 INFO - Return code: 0 08:20:44 INFO - Running post-action listener: _resource_record_post_action 08:20:44 INFO - Running post-action listener: _start_resource_monitoring 08:20:44 INFO - Starting resource monitoring. 08:20:44 INFO - [mozharness: 2016-08-18 15:20:44.121308Z] Finished create-virtualenv step (success) 08:20:44 INFO - [mozharness: 2016-08-18 15:20:44.122319Z] Running install step. 08:20:44 INFO - Running pre-action listener: _resource_record_pre_action 08:20:44 INFO - Running main action method: install 08:20:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:20:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:20:44 INFO - Reading from file tmpfile_stdout 08:20:44 INFO - Detecting whether we're running mozinstall >=1.0... 08:20:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:20:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:20:44 INFO - Reading from file tmpfile_stdout 08:20:44 INFO - Output received: 08:20:44 INFO - Usage: mozinstall [options] installer 08:20:44 INFO - Options: 08:20:44 INFO - -h, --help show this help message and exit 08:20:44 INFO - -d DEST, --destination=DEST 08:20:44 INFO - Directory to install application into. [default: 08:20:44 INFO - "/builds/slave/test"] 08:20:44 INFO - --app=APP Application being installed. [default: firefox] 08:20:44 INFO - mkdir: /builds/slave/test/build/application 08:20:44 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'] 08:20:44 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 08:21:18 INFO - Reading from file tmpfile_stdout 08:21:18 INFO - Output received: 08:21:18 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 08:21:18 INFO - Running post-action listener: _resource_record_post_action 08:21:18 INFO - [mozharness: 2016-08-18 15:21:18.264214Z] Finished install step (success) 08:21:18 INFO - [mozharness: 2016-08-18 15:21:18.264374Z] Running run-tests step. 08:21:18 INFO - Running pre-action listener: _resource_record_pre_action 08:21:18 INFO - Running main action method: run_tests 08:21:18 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:21:18 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:21:18 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:21:18 INFO - 2016-08-18 08:21:18.279 screenresolution[1638:7544] starting screenresolution argv=screenresolution get 08:21:18 INFO - 2016-08-18 08:21:18.281 screenresolution[1638:7544] Display 0: 1600x1200x32@60 08:21:18 INFO - 2016-08-18 08:21:18.287 screenresolution[1639:7546] starting screenresolution argv=screenresolution list 08:21:18 INFO - Available Modes on Display 0 08:21:18 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:21:18 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:21:18 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:21:18 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:21:18 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:21:18 INFO - Intel Iris: 08:21:18 INFO - Chipset Model: Intel Iris 08:21:18 INFO - Type: GPU 08:21:18 INFO - Bus: Built-In 08:21:18 INFO - VRAM (Dynamic, Max): 1536 MB 08:21:18 INFO - Vendor: Intel (0x8086) 08:21:18 INFO - Device ID: 0x0a2e 08:21:18 INFO - Revision ID: 0x0009 08:21:18 INFO - Displays: 08:21:18 INFO - Display: 08:21:18 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:21:18 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:21:18 INFO - Display Serial Number: 1600x1200 60 08:21:18 INFO - Main Display: Yes 08:21:18 INFO - Mirror: Off 08:21:18 INFO - Online: Yes 08:21:18 INFO - Rotation: Supported 08:21:18 INFO - Return code: 0 08:21:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:21:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:21:18 INFO - Python 2.7.3 08:21:18 INFO - Return code: 0 08:21:18 INFO - grabbing minidump binary from tooltool 08:21:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:21:18 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 0x10c533d30>, '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 0x10c298db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c52bb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:21:18 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 08:21:18 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 08:21:18 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 08:21:18 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:21:18 INFO - Return code: 0 08:21:18 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 08:21:18 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:21:18 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:21:18 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 08:21:18 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:21:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0256', '--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 08:21:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0256 --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 08:21:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jEw4pZcUIn/Render', 08:21:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:21:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:21:18 INFO - 'HOME': '/Users/cltbld', 08:21:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:21:18 INFO - 'LOGNAME': 'cltbld', 08:21:18 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:21:18 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 08:21:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:21:18 INFO - 'MOZ_NO_REMOTE': '1', 08:21:18 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:21:18 INFO - 'NO_EM_RESTART': '1', 08:21:18 INFO - 'PAGER': '/bin/cat', 08:21:18 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:21:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:21:18 INFO - 'PWD': '/builds/slave/test', 08:21:18 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:21:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:21:18 INFO - 'SHELL': '/bin/bash', 08:21:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bTMWr9IRDL/Listeners', 08:21:18 INFO - 'TMPDIR': '/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/', 08:21:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:21:18 INFO - 'USER': 'cltbld', 08:21:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:21:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:21:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:21:18 INFO - 'XPC_FLAGS': '0x0', 08:21:18 INFO - 'XPC_SERVICE_NAME': '0', 08:21:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:21:18 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0256', '--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 08:21:18 INFO - mozversion application_buildid: 20160818060054 08:21:18 INFO - mozversion application_changeset: f0077112f013b3b8e92c5aff62638cc65d963437 08:21:18 INFO - mozversion application_display_name: Nightly 08:21:18 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:21:18 INFO - mozversion application_name: Firefox 08:21:18 INFO - mozversion application_remotingname: firefox 08:21:18 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 08:21:18 INFO - mozversion application_vendor: Mozilla 08:21:18 INFO - mozversion application_version: 51.0a1 08:21:18 INFO - mozversion platform_buildid: 20160818060054 08:21:18 INFO - mozversion platform_changeset: f0077112f013b3b8e92c5aff62638cc65d963437 08:21:18 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 08:21:18 INFO - mozversion platform_version: 51.0a1 08:21:18 INFO - using testdate: 1471533678 08:21:18 INFO - actual date: 1471533678 08:21:18 INFO - starting webserver on 'localhost:49268' 08:21:18 INFO - SUITE-START | Running 2 tests 08:21:18 INFO - TEST-START | dromaeo_css 08:21:18 INFO - operating with platform_type : mac_ 08:21:18 INFO - Initialising browser for dromaeo_css test... 08:21:18 INFO - TEST-INFO | started process 1649 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/tmp3Xk9pI/profile http://localhost:49268/getInfo.html) 08:21:21 INFO - PROCESS | 1649 | __metrics Screen width/height:1600/1200 08:21:21 INFO - PROCESS | 1649 | colorDepth:24 08:21:21 INFO - PROCESS | 1649 | Browser inner width/height: 1024/689 08:21:21 INFO - PROCESS | 1649 | __metrics 08:21:21 ERROR - PROCESS | 1649 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 08:21:22 INFO - TEST-INFO | 1649: exit 0 08:21:22 INFO - Browser initialized. 08:21:22 INFO - Running cycle 1/1 for dromaeo_css test... 08:21:22 INFO - TEST-INFO | started process 1652 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/tmp3Xk9pI/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:21:34 INFO - PROCESS | 1652 | RSS: Main: 239214592 08:21:34 INFO - PROCESS | 1652 | 08:22:24 INFO - PROCESS | 1652 | 1471533744172 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] 08:24:36 INFO - PROCESS | 1652 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49268/tests/dromaeo/cssquery-ext.html) 08:24:37 INFO - PROCESS | 1652 | RSS: Main: 254603264 08:24:37 INFO - PROCESS | 1652 | 08:27:39 INFO - PROCESS | 1652 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-ext.html (next: http://localhost:49268/tests/dromaeo/cssquery-jquery.html) 08:27:40 INFO - PROCESS | 1652 | RSS: Main: 267182080 08:27:40 INFO - PROCESS | 1652 | 08:30:42 INFO - PROCESS | 1652 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49268/tests/dromaeo/cssquery-mootools.html) 08:30:43 INFO - PROCESS | 1652 | RSS: Main: 271364096 08:30:43 INFO - PROCESS | 1652 | 08:33:44 INFO - PROCESS | 1652 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49268/tests/dromaeo/cssquery-prototype.html) 08:33:45 INFO - PROCESS | 1652 | RSS: Main: 271884288 08:33:45 INFO - PROCESS | 1652 | 08:36:48 INFO - PROCESS | 1652 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49268/tests/dromaeo/cssquery-yui.html) 08:36:48 INFO - PROCESS | 1652 | RSS: Main: 277172224 08:36:48 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | Cycle 1(1): loaded http://localhost:49268/tests/dromaeo/cssquery-yui.html (next: http://localhost:49268/tests/dromaeo/cssquery-dojo.html) 08:39:51 INFO - PROCESS | 1652 | RSS: Main: 279764992 08:39:51 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | __start_tp_report 08:39:51 INFO - PROCESS | 1652 | _x_x_mozilla_page_load 08:39:51 INFO - PROCESS | 1652 | _x_x_mozilla_page_load_details 08:39:51 INFO - PROCESS | 1652 | |i|pagename|runs| 08:39:51 INFO - PROCESS | 1652 | |0;dojo.html;3176.6664500227475;3378.611459682136;3392.983035084824;3419.1964888251273;3429.7599168058237;5585.078462053766;5706.857328566783;5716.1711551824965;5742.483176514118;5818.3308919474275;4370.1915145697985;4934.013197360533;4946.802127914879;5725.7995970141055;5903.085021821625;4321.762303073329;5073.84778456645;5205.9219111713355;5286.001166029675;5388.865278368033;4650.000249946261;5116.795328186868;5305.840824775263;5346.331708536433;5380.24676545284;3693.3905905525558;4617.399738034034;5124.28260043596;5197.506236907488;5289.18017707256;5045.798168073309;5215.061288967984;5222.060029194743;5245.6852588844795;5259.86850328741;5121.103806833827;5198.506141916512;5214.60890433219;5221.843344699665;5246.658967167122;5253.684778913277;5612.5229355504425;5731.426857314277;5812.651240925558;5852.502537284336;6192.566520343577;6261.311255761862;6276.560640755149;6278.87442251157;6296.6536840473755;6154.661493617849;6245.063240513914;6279.780207692755;6298.244210694746;6306.590071645328;5855.473007429309;5931.258592675916;5956.672383018932;5957.374475680034;5971.4028597140805;6227.782027629011;6289.088082228142;6290.559660823698;6305.96847015762;6311.96844015777;6017.548683848729;6180.536459765445;6211.440970312694;6213.844653883599;6228.750849965951;6116.640127388518;6156.230471191101;6220;6220.875582488325;6226.5641405102115;6133.5182902793495;6202.28673702521;6214.40963108504;6216.316205217422;6228.065790131516;6253.312135665074;6279.717412716439;6285.717142728588;6298.905516417258;6300.779472718525;4849.418069831572;4925.187344088257;4941.258811178352;4980.551750342486;4991.950080499221;4405.118976204772;4423.800928958204;4445.622122119591;4461.442319710036;4475.216837053503;5557.027520183951;5696.857578560569;5945.524358051345;5949.970250148722;5994.910076348859;6208.596441231305;6210.5652604317265;6278.246610406781;6279.215098112736;6280.900842352661;5868.383819698955;5940.376260492672;5958.344582095966;5972.223610930551;5977.491913187341;5453.318335208099;5454.91817622736;5471.534919531884;5488.643238189505;5503.11950087984;6182.505399567934;6277.1525844010475;6308.274548426898;6319.210098737658;6319.8104056878365;6199.845003874939;6219.129321895029;6226.1905952225925;6250.1874756281395;6267.811965641038;6353.96823015882;6377.394147555975;6393.776217832354;6397.168368112116;6407.71165297572;6114;6178.969105154445;6201.658908760061;6233.940230160974;6248.906266406098;6157;6224.844378890382;6267.9344511432255;6273.529485288713;6279.089532017923;6170.167027451236;6195.411435913581;6221.564490485623;6226.937730622817;6242.188515493139;6046.697665116814;6124.112003759519;6195.977663685441;6206.658633775005;6246.031865060922;4380.8685739427865;4788.473267940593;4887.34020907173;5023.623228257822;6075.848103797263;6163.229596300463;6186.4741496973265;6187.938120618916;6196.380361963767;6210.968945155245;5940.435658612425;6005.489533389711;6041.848953776191;6092.147099405998;6110.511159107172 08:39:51 INFO - PROCESS | 1652 | |1;ext.html;459.3821310337596;472.7187323542493;528.4688887667895;539.9865003374917;550.2846299810246;30843.84578077109;40970.38544421836;41038.17923641526;41069.97325066875;41145;41678;42367;42395;42442.57557424425;42488;9708.902910970888;9850.753731156743;9875.234934218395;9877;9891.653792117277;8444.451110677817;9780.266480013992;9831.459269740162;9836.508174591278;9842.360246583985;9779.55991980359;9821.70534883951;9822.508874556279;9864.062914023192;9869.753256168582;9766.755831104208;9785.168260697848;9811.166050885684;9874.703758887244;9877.703668889873;9660.37207581512;9757.414555126716;9775.266854985905;9790.75523111928;9795.510224488748;39833;40013.79993100016;40135.39796903049;40250.98745062735;40384.19231615381;2634.5126151662002;3275.3613045456145;3322.883699070545;3504.9649503504893;3533.4346504559403;29936.203827770187;30339;30413;31312.686873131206;31394.686053139405;3127.4526957782523;3157.494800831856;3181.077487528614;3184.1561986073707;3255.186203449138;474035.51928961574;508312;522059.9999999962;643715;645212;60917.69541152354;61275.69362153161;61298.69350653218;61354.69322653358;61385.386146137964;34660.82669586636;35253.47119793205;63051.05423418652;63414;63658;16590.917045414695;16697.83302166987;16808.495745127664;16815.91592042032;16853.747193792104;12778.872211277954;12810.80783788244;12913.677158070936;12932.030097742707;12965.805512917314;19164.71252931207;19167.616647666968;19183.136758845885;19197.232110715693;19233.51916202106;8050.758477245575;8173.959130204311;8178.141295164041;8206.630701618442;8208.712695055763;856.208007592974;993.1607791416242;994.8607194992562;1001.3891526169031;1052.952617132231;29413.676384562747;30413.239669008453;30524.84737576298;30686.38627227443;31287.68712312848;959.510649568725;1020.7193021919031;1030.7886883188928;1034.4000479721744;1035.2028937718067;12439.315837628836;12764.680882977815;13420.127691700009;14249.501267455797;15776.921115394349;499935;620709;622367;623553;623723;59477.70261148753;59963.400365996655;59964.70017649971;60004.69997649984;60266;1351.216294549159;1360.7890776929592;1392.8746412822895;1396.427464739452;1401.7897315402772;26334.604980925684;28691.28271793222;29445.26386840346;30997.646026173068;31265.68734312628;52812.471875282296;53041.7347913258;53090.73454632702;53758.46241537535;54514;568041;569807;570425;570998;574025;27288.04491842776;27667.861660691568;27684.169474915783;27749.722502775523;27811.860940695165;48703.756481218785;49025.01949961052;49042;49189.03243870205;49750;39648.40527392034;40036.799816000734;40516;40667.59332406638;40742.24798507124;37906.81046594749;39893.80318590447;39943.40084898787;41001.179976400905;41245.58754412417;38087.80956095202;38476.653317133765;39036.609633903296;39514.604853951096;39531.40702889401;34398.312033759685;35849.82075089608;41123;41959.370609441496;43456.565434345255;31863.68136318607;33013.83493082519;33066;33120;33323.50014749829 08:39:51 INFO - PROCESS | 1652 | |2;jquery.html;316.4635942078178;366.41190888623777;376.27754710954974;384;405.50528355406414;20509.282175123873;20531.692024619624;21119.47201319964;21342.99999999998;21547.46131346717;11833.940830295858;12071.33607651581;12144.574939877106;12177.695557611065;13433.596992090228;5311.840644780644;5443.727813609304;5451.3458384993855;5485.670859748428;5547.55619550437;3826.7321287509885;5437.102878025141;5785.3925337839555;6046.304674962392;6092.878142437148;6088.695565221743;6135.110408990694;6143.938560614403;6154.476869466101;6162.9383706163035;6339.587926784744;6668.699908504104;6716.731330746764;6724;6738.35985581369;5651.2935883014625;5835.4748072673665;5874.9118763218585;5880.4119588041285;5900.822975310747;13299.66750831237;17517;17531.386401476015;26613.600795988077;26714.73285267142;2268.6143355629583;2303.4817166137655;2353.7175538935267;2935.5890175375466;2977.285451491648;9987.75030624233;10149.543270552844;10163.542640581118;10217.33587316822;10337;1630.584201028742;1746.777255920848;1900.363378268268;1915.4636701723539;1944.8152425519554;77113.22886771116;113332;125105.74894251033;125611.99999999908;126091;10926.235163538477;11151.72120696989;11310.60412885545;11547.307161570332;11586.71033224176;14102.153870767786;14180;14250.429982800779;14336.784948225784;14344.856551434561;7113.110861142357;8271.95864020676;8536.591462408633;8691.782705432415;8712.869306960401;8562.828743425096;8606.096359882247;8633.95683021581;8696.826063478695;8801.955990220007;4448.7108337957925;4532.27483602622;4533.682642215013;4589.173948689201;4644.49197433389;1595.2900959073334;1671.9049022890026;1688.0715606416668;1932.603816217672;2005.7793642699291;929.3401684803865;949.2832911152174;994.2791476179711;1000.1848493477793;1013.3919648211162;20829.375118746462;21031.94840257981;21051.368458946257;21187.60998240274;21252.831094289962;795.9482633628795;913.0276255787564;921.5530467723149;964.2141654551658;982.2142286171035;10026.69919902404;10400.791984160274;11069.5572177112;11120.666380008613;11141.164412669083;607942;614702;618105;626485;633639;126184.84537886626;134132;139825.60174398328;150645;154570;948.1608776232946;981.3915372469115;989.3816364772017;990.0396615283164;1026.4559783315005;15852;18687.719684204476;19534.120964556914;19584.31454899072;19592.628516003744;41821.79089104535;59960.700196498736;60739.48151296253;60846.08730869129;61859.690701546206;88779.66830497677;88906;89942;89983;89987;6803.251642319242;8016.717325227935;8082.272595466201;8212.63043163071;8222.671093156447;11335.376554289593;11706.180567360203;11732;13007.479700811862;13366.198028118344;11096.056835169102;11295.661130166109;11340.489677964346;11501.597444089417;11521.884781152416;11026.393548354918;11173.664790055986;11213.60752373663;11393.145514086642;11591.710207244887;11388.487518061873;11547.653570392902;11550.553037080617;11594;11629;7911.881321780293;7999.760007199793;8062.5890469168835;8187.59618651687;8275.462094963808;10848.457577120955;11311.490982905954;11317.773644527228;11337.979581837673;11338.659840204808 08:39:51 INFO - PROCESS | 1652 | |3;mootools.html;1515.6589767302355;1529.3041666041952;1761.6476704659071;1781.7238328059154;1874.41893013166;7338.266173382659;7761.805954851132;8458.196471335228;8838.292936565067;8846.646134154642;8516.531590762506;8695.347848911326;8701.521416322099;8706.434081784679;8736.43213191142;2343.097907305691;2378.702662167229;2379.8929048192786;2383.1301574925114;2387.8089752819733;2334.3580515358326;2358.5518751437257;2382.1424287256573;2383.285014495653;2389.4145934246135;1983.1769815526538;2223.8888055597236;2366.8934897929635;2373.9287821365388;2376.940576485584;2085.405659387075;2343.6250199968094;2356.1871154451774;2361.49227915998;2364.8226383021342;1923.6441258367247;1934.9709754353696;2336.8013718833918;2347.5891718949115;2349.271725765001;7970.043594768665;8034.517928924283;8713.738587842376;8751.474911505331;8761.956190219073;5140.177571588528;5213.061648903196;5298.417174110845;5303.071962406563;5316.840494785162;3516.6659167379057;3577.6422357764277;3636.5272514573203;3643.7429086964953;3715.145516531186;1050.2298924528907;1084.6312253833655;1092.8688557373166;1102.9613963511238;1108.7505311304972;11266.985971262544;11322.943385283103;11346.71633209168;11411.54353825846;11428.085753139729;4548.636109111263;4562;4745.078243311465;4752.287156926489;4767.022760334124;9685.951570242245;9780.070893265129;9808.460534670661;9808.803823923625;9841.655542055994;5259.789608415697;5282;5301.761420736076;5309.123994540934;5310.92033619496;4354.390385346054;4686.390769199982;4814.422269327703;4865.051314993542;4868.659193856467;3440.2431465077643;3823.3118038752737;3861.687026411034;3900.7854567998465;4010.939835902464;1132.5243397772956;1298.6298904812083;1313.7832257677376;1319.3535167767916;1324.708564115893;887.9556022198864;914.9908500915038;918.8300164469595;923.6905636611676;935.4901578639658;5881.735321910439;5882.735276912549;5914.319853216849;5997.850053748692;6217.098520714561;904.3036861616519;915.1306259053925;963.0995019656643;980.3284749946309;998.670438755209;3912.315344814646;3923.2153569286256;3925.6859451244404;4060.6954478413645;4071.633552980246;10338.172946164288;10699.572017119384;10706.46467676613;10715.83926241107;10732.356058636507;10632.362058276529;10681.465926703633;10687.786244275227;10718.73203169927;10780.730481738019;7649.502782319243;8054.23484768946;8095.919040809635;8240.299574536111;8263.256306932404;4981.551660350586;5951.1168887874965;5997.31030931431;6086.908696369646;6117;8187.795305117182;9322.161005509537;9766.56050477716;9922.950385248316;9937.950310248403;7849.4897831640765;7869.48848324857;8153;9734.464604446823;10199.490025498548;6053.909191362045;6312.242530896322;6351.841203969753;6924.515283930278;7588.392928565591;8296.377771667028;8361.080281168945;8376;8388.706395276136;8404;7362.6318684066655;7505.099388073466;7520.435967302365;7585.2035536267895;7603.353714934293;6676.699548520425;7233.276672332935;7369.286337028272;7376.225496322809;7479.289467500579;5838.1826544282985;6921.2386637468835;7008.789736307919;7009.334113259232;7014.368706816411;4435.800388982439;5012.498750124958;5047.772850221675;5064.316317297118;5108.795648174031;4193.9370909435775;4941.75291235444;5032.974835125801;5100.872478188075;5121 08:39:51 INFO - PROCESS | 1652 | |4;prototype.html;277.555910543131;307.4266492990572;316.7172949554306;317.2861062609129;320.70014536408445;5085.364329458817;5341.893162136755;5478.205660179282;5622.8313150605445;5787.334456537499;4261.573842615745;4829.0824743298745;5688.886222275562;5706.1440783882435;5710.77156913724;4336.97831510842;4351.456067991501;4367.279398899178;4378.1462614790125;4385.802638881258;4202.159568086379;4307.332363483665;4341.6309613682715;4374.868753937387;4377.934330985022;3726.6646001859826;4120.361343991671;4279.03721662625;4301.741895486281;4303.848075962019;4290.592393722592;4300.5269420363575;4321.762303073329;4334.523202447728;4366.868993930156;3481.35594914939;3731.5708693500324;3747.7563958342894;3753.972854658481;3755.9295600753926;4759.428868535763;4937.5561994205145;5496.900619876041;5556.277683901108;5584.776608935637;4090.9999999999704;4329.588689074533;4662.976685116587;4971.726555039471;4973.836381174201;5788.350320158776;5991.861546306188;6033.8189854304;6037.698115094227;6081;4066.573009833984;4074.9185016299507;4075.9388609170887;4077.756284333277;4105.363668631367;5856.97071514644;6182.505399568024;6381.3937675920715;6407.487401007955;6435.259945106326;3806.657400833938;3823.5602905665646;3938.350172221609;4157.378622337291;4180.47744031996;3196.376706542202;3480.930381392358;4201.458117838724;4227.387028880857;4260.957390426118;4483.775811209426;4565.9270071533165;4934.55588996992;4958.355413796184;5002.199648056367;5221.242919776611;5304.575633949275;6106.6336019838955;6128.846778830565;6176.270644219626;1363.541011118094;1399.5661344983089;1403.4526534651493;1406.7538180818522;1408.197327523302;818.8771684247411;840.5461051032374;854.5043874552745;856.1695155698962;858.5406807358158;4233.640140588023;4364.9127017460105;4641.327007583882;4813.735244561512;4863.610911127102;4479.529649386833;4635;4720.551547602972;4821.855344339676;5251.658642188246;4443.578055022426;4457.866264012085;4467.872489257533;4732.503087175797;4750.809967601326;2869.684334723179;3265.6081270247723;3288.408086544445;3311.337732453519;3314.93370132596;4886.828960986349;5776.653400795882;5944.494717948936;6489.740410383626;6495.271985765895;5102.617303702237;5587.552995760329;5888.322842873039;6207.503399728011;6434.292227854932;5168.81909133186;5679.488846003879;5763.94236057634;6477.664003038345;6507.663715753037;5015.799368025238;5299.2316114164005;5587.7485513152815;5897.5281977440845;6303.306636269915;5129.8717532062;5662.687327913217;5980.222571065734;6132.191003653844;6168.629882207082;6437.25971513282;6439.195100612424;6452.225732911893;6460.25707043696;6493.902591461037;3558.2349794794245;3804.391297392404;3945.408188771707;4000.299947509116;4013.4381186634478;4853.587445067209;5673.546116310603;6134.509239260759;6169.259688837368;6234.812955611339;5032.7483625819295;6033.2805150531885;6037.547183961133;6044.881696885915;6053;5500.202470641814;5584.553235741049;5664.688442135722;5954.880902382015;5995.670238136944;5153.871153221199;5285.550728188147;5479.821703411932;5821.330546986981;5913.58604897653;4993.575546078624;5257.921131183112;5656.236408084856;6004.849878753066;6043.486303664062;5410.377806552139;5773.393793651606;5849.824505264849;5867.618604790675;5894.793682221101 08:39:51 INFO - PROCESS | 1652 | |5;yui.html;611.251217258858;614.6527212125148;659.8350412396901;728.5555810955316;772.6677528662675;17024.744628830562;17722.46832595021;17728.29086836525;18258.99575523349;18271.269149234016;16273.186340682978;16374.672506549861;16580.005199687996;16592.336306547724;16601.50195494137;681.4616453002147;835.3985130705897;869.0397111192104;872.5593575244525;873.1792115411524;833.6373677450298;849.9490030598184;863.8833757442759;865.26020252684;866.0819531296845;901.8061116859874;910.41733290694;912.069688917304;913.8400779863531;915.6474757218485;882.382332367339;894.2443635128307;907.7685190276503;908.4730856103511;909.5134103254793;671.835400326923;675.2538445018282;676.4149011105359;677.0217036382429;678.9849175482635;15320.310586023656;15384.461543845911;15392.922495425324;15441.922790385976;15467.994580352353;14325.498607548685;14338.928305358511;14382.35279412429;14403.71192576153;14478.855211447855;9789;11918.582849600223;11941.283522988648;12009.819852702216;12035.398230088547;3826.2921359548573;3829.7319187656876;3850.634189751969;3869.7678139311734;4013.8795836124964;100758;103561.48219258855;105282;116551.83448165495;124097.37951310186;11039.72400689973;11083.002529772359;11214.271072380268;11268.042216411533;11355.545778168946;21752;21807.127714891227;21939.122435102738;21974;22092.226772062902;8075.192480751995;8159.714409995621;8186.017677878693;8233.135520770353;8322.334213262924;4613.400257966443;4639.211334073216;4688.249880019249;4745.881352966204;4768.856934291976;3225.548423220751;3655.5065066216252;3765.4351847223134;3784.962150378461;3794.829232684536;569.6553585081049;574.1932584718477;688.2601203706037;693.6739732325799;695.2109355881112;533.4985113992834;666.7533012785301;681.5433659448181;685.766839274649;698.7274962764526;8057.677692892219;9102.271818254523;9658.565364558612;9745.074217949283;9892.889392208408;574.1072632057108;592.7540070870626;615.6552330694825;653.6698967021719;676.8477092654114;4493.460784705856;4647.7451088206;4763.2140696784645;4765.237561990134;4786.44955830077;98223.52664710036;139328.30335848255;152481;160097;165361;119936;146330;146880.5311946888;150541.99999999782;151535.24232378768;78494.60752696314;80411.99999999884;104181.45641066613;124111;127623;7541.698332066656;9630.614775408905;9955.850662240216;10037.347572408062;10150.796984060129;57465.4140563684;57486.562835929435;61690.766184676955;66168.00747988687;67625.97122086346;86491;94735;99358.5032074835;100054.4997275009;100228.99542009264;10646.680599582025;12399.628011159679;13025.427095748682;13071.215727056408;13288.136271142344;14673.413063477768;14830.332635031235;14836.18400987956;14874.702505949605;14901.92549037248;13709.520166794115;13777.173369597856;13884.09753366028;13918.09532380392;14024.649383765487;13764.380602872694;13939.581812545639;13951.720965580835;14183.432662693376;14362.425502979764;13137.540186093442;13503.39234734459;13589.184648921097;13703.657408564866;13940.651483712989;10926.289791163548;11209.887901120885;11380.772384552098;11424.428778561205;11551.249168804;9506.572204250964;9926.503674816375;11278.266912650652;11381.772364552828;11625 08:39:51 INFO - PROCESS | 1652 | __end_tp_report 08:39:51 INFO - PROCESS | 1652 | __start_cc_report 08:39:51 INFO - PROCESS | 1652 | _x_x_mozilla_cycle_collect,421 08:39:51 INFO - PROCESS | 1652 | __end_cc_report 08:39:51 INFO - PROCESS | 1652 | __startTimestamp1471534791568__endTimestamp 08:39:51 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | ------- Summary: start ------- 08:39:51 INFO - PROCESS | 1652 | Number of tests: 6 08:39:51 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | [#0] dojo.html Cycles:165 Average:5718.96 Median:6041.85 stddev:713.75 (11.8%) stddev-sans-first:687.51 08:39:51 INFO - PROCESS | 1652 | Values: 3176.7 3378.6 3393.0 3419.2 3429.8 5585.1 5706.9 5716.2 5742.5 5818.3 4370.2 4934.0 4946.8 5725.8 5903.1 4321.8 5073.8 5205.9 5286.0 5388.9 4650.0 5116.8 5305.8 5346.3 5380.2 3693.4 4617.4 5124.3 5197.5 5289.2 5045.8 5215.1 5222.1 5245.7 5259.9 5121.1 5198.5 5214.6 5221.8 5246.7 5253.7 5612.5 5731.4 5812.7 5852.5 6192.6 6261.3 6276.6 6278.9 6296.7 6154.7 6245.1 6279.8 6298.2 6306.6 5855.5 5931.3 5956.7 5957.4 5971.4 6227.8 6289.1 6290.6 6306.0 6312.0 6017.5 6180.5 6211.4 6213.8 6228.8 6116.6 6156.2 6220.0 6220.9 6226.6 6133.5 6202.3 6214.4 6216.3 6228.1 6253.3 6279.7 6285.7 6298.9 6300.8 4849.4 4925.2 4941.3 4980.6 4992.0 4405.1 4423.8 4445.6 4461.4 4475.2 5557.0 5696.9 5945.5 5950.0 5994.9 6208.6 6210.6 6278.2 6279.2 6280.9 5868.4 5940.4 5958.3 5972.2 5977.5 5453.3 5454.9 5471.5 5488.6 5503.1 6182.5 6277.2 6308.3 6319.2 6319.8 6199.8 6219.1 6226.2 6250.2 6267.8 6354.0 6377.4 6393.8 6397.2 6407.7 6114.0 6179.0 6201.7 6233.9 6248.9 6157.0 6224.8 6267.9 6273.5 6279.1 6170.2 6195.4 6221.6 6226.9 6242.2 6046.7 6124.1 6196.0 6206.7 6246.0 4380.9 4788.5 4887.3 5023.6 6075.8 6163.2 6186.5 6187.9 6196.4 6211.0 5940.4 6005.5 6041.8 6092.1 6110.5 08:39:51 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | [#1] ext.html Cycles:180 Average:71222.84 Median:41019.68 stddev:154385.41 (376.4%) stddev-sans-first:154727.08 08:39:51 INFO - PROCESS | 1652 | Values: 459.4 472.7 528.5 540.0 550.3 30843.8 40970.4 41038.2 41070.0 41145.0 41678.0 42367.0 42395.0 42442.6 42488.0 9708.9 9850.8 9875.2 9877.0 9891.7 8444.5 9780.3 9831.5 9836.5 9842.4 9779.6 9821.7 9822.5 9864.1 9869.8 9766.8 9785.2 9811.2 9874.7 9877.7 9660.4 9757.4 9775.3 9790.8 9795.5 39833.0 40013.8 40135.4 40251.0 40384.2 2634.5 3275.4 3322.9 3505.0 3533.4 29936.2 30339.0 30413.0 31312.7 31394.7 3127.5 3157.5 3181.1 3184.2 3255.2 474035.5 508312.0 522060.0 643715.0 645212.0 60917.7 61275.7 61298.7 61354.7 61385.4 34660.8 35253.5 63051.1 63414.0 63658.0 16590.9 16697.8 16808.5 16815.9 16853.7 12778.9 12810.8 12913.7 12932.0 12965.8 19164.7 19167.6 19183.1 19197.2 19233.5 8050.8 8174.0 8178.1 8206.6 8208.7 856.2 993.2 994.9 1001.4 1053.0 29413.7 30413.2 30524.8 30686.4 31287.7 959.5 1020.7 1030.8 1034.4 1035.2 12439.3 12764.7 13420.1 14249.5 15776.9 499935.0 620709.0 622367.0 623553.0 623723.0 59477.7 59963.4 59964.7 60004.7 60266.0 1351.2 1360.8 1392.9 1396.4 1401.8 26334.6 28691.3 29445.3 30997.6 31265.7 52812.5 53041.7 53090.7 53758.5 54514.0 568041.0 569807.0 570425.0 570998.0 574025.0 27288.0 27667.9 27684.2 27749.7 27811.9 48703.8 49025.0 49042.0 49189.0 49750.0 39648.4 40036.8 40516.0 40667.6 40742.2 37906.8 39893.8 39943.4 41001.2 41245.6 38087.8 38476.7 39036.6 39514.6 39531.4 34398.3 35849.8 41123.0 41959.4 43456.6 31863.7 33013.8 33066.0 33120.0 33323.5 08:39:51 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | [#2] jquery.html Cycles:180 Average:35975.18 Median:2328.60 stddev:103863.43 (4460.3%) stddev-sans-first:104120.29 08:39:51 INFO - PROCESS | 1652 | Values: 316.5 366.4 376.3 384.0 405.5 20509.3 20531.7 21119.5 21343.0 21547.5 11833.9 12071.3 12144.6 12177.7 13433.6 5311.8 5443.7 5451.3 5485.7 5547.6 3826.7 5437.1 5785.4 6046.3 6092.9 6088.7 6135.1 6143.9 6154.5 6162.9 6339.6 6668.7 6716.7 6724.0 6738.4 5651.3 5835.5 5874.9 5880.4 5900.8 13299.7 17517.0 17531.4 26613.6 26714.7 2268.6 2303.5 2353.7 2935.6 2977.3 9987.8 10149.5 10163.5 10217.3 10337.0 1630.6 1746.8 1900.4 1915.5 1944.8 77113.2 113332.0 125105.7 125612.0 126091.0 10926.2 11151.7 11310.6 11547.3 11586.7 14102.2 14180.0 14250.4 14336.8 14344.9 7113.1 8272.0 8536.6 8691.8 8712.9 8562.8 8606.1 8634.0 8696.8 8802.0 4448.7 4532.3 4533.7 4589.2 4644.5 1595.3 1671.9 1688.1 1932.6 2005.8 929.3 949.3 994.3 1000.2 1013.4 20829.4 21031.9 21051.4 21187.6 21252.8 795.9 913.0 921.6 964.2 982.2 10026.7 10400.8 11069.6 11120.7 11141.2 607942.0 614702.0 618105.0 626485.0 633639.0 126184.8 134132.0 139825.6 150645.0 154570.0 948.2 981.4 989.4 990.0 1026.5 15852.0 18687.7 19534.1 19584.3 19592.6 41821.8 59960.7 60739.5 60846.1 61859.7 88779.7 88906.0 89942.0 89983.0 89987.0 6803.3 8016.7 8082.3 8212.6 8222.7 11335.4 11706.2 11732.0 13007.5 13366.2 11096.1 11295.7 11340.5 11501.6 11521.9 11026.4 11173.7 11213.6 11393.1 11591.7 11388.5 11547.7 11550.6 11594.0 11629.0 7911.9 7999.8 8062.6 8187.6 8275.5 10848.5 11311.5 11317.8 11338.0 11338.7 08:39:51 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | [#3] mootools.html Cycles:180 Average:5582.90 Median:5114.90 stddev:3091.03 (60.4%) stddev-sans-first:3084.59 08:39:51 INFO - PROCESS | 1652 | Values: 1515.7 1529.3 1761.6 1781.7 1874.4 7338.3 7761.8 8458.2 8838.3 8846.6 8516.5 8695.3 8701.5 8706.4 8736.4 2343.1 2378.7 2379.9 2383.1 2387.8 2334.4 2358.6 2382.1 2383.3 2389.4 1983.2 2223.9 2366.9 2373.9 2376.9 2085.4 2343.6 2356.2 2361.5 2364.8 1923.6 1935.0 2336.8 2347.6 2349.3 7970.0 8034.5 8713.7 8751.5 8762.0 5140.2 5213.1 5298.4 5303.1 5316.8 3516.7 3577.6 3636.5 3643.7 3715.1 1050.2 1084.6 1092.9 1103.0 1108.8 11267.0 11322.9 11346.7 11411.5 11428.1 4548.6 4562.0 4745.1 4752.3 4767.0 9686.0 9780.1 9808.5 9808.8 9841.7 5259.8 5282.0 5301.8 5309.1 5310.9 4354.4 4686.4 4814.4 4865.1 4868.7 3440.2 3823.3 3861.7 3900.8 4010.9 1132.5 1298.6 1313.8 1319.4 1324.7 888.0 915.0 918.8 923.7 935.5 5881.7 5882.7 5914.3 5997.9 6217.1 904.3 915.1 963.1 980.3 998.7 3912.3 3923.2 3925.7 4060.7 4071.6 10338.2 10699.6 10706.5 10715.8 10732.4 10632.4 10681.5 10687.8 10718.7 10780.7 7649.5 8054.2 8095.9 8240.3 8263.3 4981.6 5951.1 5997.3 6086.9 6117.0 8187.8 9322.2 9766.6 9923.0 9938.0 7849.5 7869.5 8153.0 9734.5 10199.5 6053.9 6312.2 6351.8 6924.5 7588.4 8296.4 8361.1 8376.0 8388.7 8404.0 7362.6 7505.1 7520.4 7585.2 7603.4 6676.7 7233.3 7369.3 7376.2 7479.3 5838.2 6921.2 7008.8 7009.3 7014.4 4435.8 5012.5 5047.8 5064.3 5108.8 4193.9 4941.8 5033.0 5100.9 5121.0 08:39:51 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | [#4] prototype.html Cycles:180 Average:4710.63 Median:5009.00 stddev:1465.07 (29.2%) stddev-sans-first:1430.89 08:39:51 INFO - PROCESS | 1652 | Values: 277.6 307.4 316.7 317.3 320.7 5085.4 5341.9 5478.2 5622.8 5787.3 4261.6 4829.1 5688.9 5706.1 5710.8 4337.0 4351.5 4367.3 4378.1 4385.8 4202.2 4307.3 4341.6 4374.9 4377.9 3726.7 4120.4 4279.0 4301.7 4303.8 4290.6 4300.5 4321.8 4334.5 4366.9 3481.4 3731.6 3747.8 3754.0 3755.9 4759.4 4937.6 5496.9 5556.3 5584.8 4091.0 4329.6 4663.0 4971.7 4973.8 5788.4 5991.9 6033.8 6037.7 6081.0 4066.6 4074.9 4075.9 4077.8 4105.4 5857.0 6182.5 6381.4 6407.5 6435.3 3806.7 3823.6 3938.4 4157.4 4180.5 3196.4 3480.9 4201.5 4227.4 4261.0 4483.8 4565.9 4934.6 4958.4 5002.2 5221.2 5304.6 6106.6 6128.8 6176.3 1363.5 1399.6 1403.5 1406.8 1408.2 818.9 840.5 854.5 856.2 858.5 4233.6 4364.9 4641.3 4813.7 4863.6 4479.5 4635.0 4720.6 4821.9 5251.7 4443.6 4457.9 4467.9 4732.5 4750.8 2869.7 3265.6 3288.4 3311.3 3314.9 4886.8 5776.7 5944.5 6489.7 6495.3 5102.6 5587.6 5888.3 6207.5 6434.3 5168.8 5679.5 5763.9 6477.7 6507.7 5015.8 5299.2 5587.7 5897.5 6303.3 5129.9 5662.7 5980.2 6132.2 6168.6 6437.3 6439.2 6452.2 6460.3 6493.9 3558.2 3804.4 3945.4 4000.3 4013.4 4853.6 5673.5 6134.5 6169.3 6234.8 5032.7 6033.3 6037.5 6044.9 6053.0 5500.2 5584.6 5664.7 5954.9 5995.7 5153.9 5285.6 5479.8 5821.3 5913.6 4993.6 5257.9 5656.2 6004.8 6043.5 5410.4 5773.4 5849.8 5867.6 5894.8 08:39:51 INFO - PROCESS | 1652 | 08:39:51 INFO - PROCESS | 1652 | [#5] yui.html Cycles:180 Average:25210.75 Median:3775.20 stddev:40402.17 (1070.2%) stddev-sans-first:40473.29 08:39:51 INFO - PROCESS | 1652 | Values: 611.3 614.7 659.8 728.6 772.7 17024.7 17722.5 17728.3 18259.0 18271.3 16273.2 16374.7 16580.0 16592.3 16601.5 681.5 835.4 869.0 872.6 873.2 833.6 849.9 863.9 865.3 866.1 901.8 910.4 912.1 913.8 915.6 882.4 894.2 907.8 908.5 909.5 671.8 675.3 676.4 677.0 679.0 15320.3 15384.5 15392.9 15441.9 15468.0 14325.5 14338.9 14382.4 14403.7 14478.9 9789.0 11918.6 11941.3 12009.8 12035.4 3826.3 3829.7 3850.6 3869.8 4013.9 100758.0 103561.5 105282.0 116551.8 124097.4 11039.7 11083.0 11214.3 11268.0 11355.5 21752.0 21807.1 21939.1 21974.0 22092.2 8075.2 8159.7 8186.0 8233.1 8322.3 4613.4 4639.2 4688.2 4745.9 4768.9 3225.5 3655.5 3765.4 3785.0 3794.8 569.7 574.2 688.3 693.7 695.2 533.5 666.8 681.5 685.8 698.7 8057.7 9102.3 9658.6 9745.1 9892.9 574.1 592.8 615.7 653.7 676.8 4493.5 4647.7 4763.2 4765.2 4786.4 98223.5 139328.3 152481.0 160097.0 165361.0 119936.0 146330.0 146880.5 150542.0 151535.2 78494.6 80412.0 104181.5 124111.0 127623.0 7541.7 9630.6 9955.9 10037.3 10150.8 57465.4 57486.6 61690.8 66168.0 67626.0 86491.0 94735.0 99358.5 100054.5 100229.0 10646.7 12399.6 13025.4 13071.2 13288.1 14673.4 14830.3 14836.2 14874.7 14901.9 13709.5 13777.2 13884.1 13918.1 14024.6 13764.4 13939.6 13951.7 14183.4 14362.4 13137.5 13503.4 13589.2 13703.7 13940.7 10926.3 11209.9 11380.8 11424.4 11551.2 9506.6 9926.5 11278.3 11381.8 11625.0 08:39:51 INFO - PROCESS | 1652 | -------- Summary: end -------- 08:39:51 INFO - PROCESS | 1652 | 08:39:52 INFO - TEST-INFO | 1652: exit 0 08:39:52 INFO - TEST-OK | dromaeo_css | took 1113288ms 08:39:52 INFO - TEST-START | kraken 08:39:52 INFO - operating with platform_type : mac_ 08:39:52 INFO - Initialising browser for kraken test... 08:39:52 INFO - TEST-INFO | started process 1662 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/tmpGTcigO/profile http://localhost:49268/getInfo.html) 08:39:55 INFO - PROCESS | 1662 | __metrics Screen width/height:1600/1200 08:39:55 INFO - PROCESS | 1662 | colorDepth:24 08:39:55 INFO - PROCESS | 1662 | Browser inner width/height: 1024/689 08:39:55 INFO - PROCESS | 1662 | __metrics 08:39:55 ERROR - PROCESS | 1662 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 08:39:55 INFO - TEST-INFO | 1662: exit 0 08:39:55 INFO - Browser initialized. 08:39:55 INFO - Running cycle 1/1 for kraken test... 08:39:55 INFO - TEST-INFO | started process 1664 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/T/tmpGTcigO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:40:07 INFO - PROCESS | 1664 | RSS: Main: 239144960 08:40:07 INFO - PROCESS | 1664 | 08:40:10 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-beat-detection) 08:40:11 INFO - PROCESS | 1664 | RSS: Main: 251949056 08:40:11 INFO - PROCESS | 1664 | 08:40:14 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-dft) 08:40:14 INFO - PROCESS | 1664 | RSS: Main: 260743168 08:40:14 INFO - PROCESS | 1664 | 08:40:18 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-fft) 08:40:18 INFO - PROCESS | 1664 | RSS: Main: 263536640 08:40:18 INFO - PROCESS | 1664 | 08:40:20 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49268/tests/kraken/driver.html?testName=audio-oscillator) 08:40:21 INFO - PROCESS | 1664 | RSS: Main: 264855552 08:40:21 INFO - PROCESS | 1664 | 08:40:23 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:40:24 INFO - PROCESS | 1664 | RSS: Main: 265228288 08:40:24 INFO - PROCESS | 1664 | 08:40:27 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-darkroom) 08:40:27 INFO - PROCESS | 1664 | RSS: Main: 266526720 08:40:27 INFO - PROCESS | 1664 | 08:40:30 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49268/tests/kraken/driver.html?testName=imaging-desaturate) 08:40:31 INFO - PROCESS | 1664 | RSS: Main: 266166272 08:40:31 INFO - PROCESS | 1664 | 08:40:34 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49268/tests/kraken/driver.html?testName=json-parse-financial) 08:40:35 INFO - PROCESS | 1664 | RSS: Main: 266924032 08:40:35 INFO - PROCESS | 1664 | 08:40:36 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49268/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:40:37 INFO - PROCESS | 1664 | RSS: Main: 266522624 08:40:37 INFO - PROCESS | 1664 | 08:40:39 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:40:39 INFO - PROCESS | 1664 | RSS: Main: 266711040 08:40:39 INFO - PROCESS | 1664 | 08:40:42 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:40:42 INFO - PROCESS | 1664 | RSS: Main: 266899456 08:40:42 INFO - PROCESS | 1664 | 08:40:45 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:40:46 INFO - PROCESS | 1664 | RSS: Main: 266760192 08:40:46 INFO - PROCESS | 1664 | 08:40:49 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:40:50 INFO - PROCESS | 1664 | RSS: Main: 267493376 08:40:50 INFO - PROCESS | 1664 | 08:40:51 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49268/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49268/tests/kraken/driver.html?testName=ai-astar) 08:40:52 INFO - PROCESS | 1664 | RSS: Main: 268296192 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | __start_tp_report 08:40:52 INFO - PROCESS | 1664 | _x_x_mozilla_page_load 08:40:52 INFO - PROCESS | 1664 | _x_x_mozilla_page_load_details 08:40:52 INFO - PROCESS | 1664 | |i|pagename|runs| 08:40:52 INFO - PROCESS | 1664 | |0;ai-astar;106;115;109;116;116;115;118;116;116;114 08:40:52 INFO - PROCESS | 1664 | |1;audio-beat-detection;141;112;175;178;112;128;128;109;171;138 08:40:52 INFO - PROCESS | 1664 | |2;audio-dft;193;207;205;232;222;271;211;200;209;269 08:40:52 INFO - PROCESS | 1664 | |3;audio-fft;71;80;75;141;60;59;59;61;140;60 08:40:52 INFO - PROCESS | 1664 | |4;audio-oscillator;69;77;152;70;72;79;110;57;71;129 08:40:52 INFO - PROCESS | 1664 | |5;imaging-gaussian-blur;91;87;107;133;88;133;138;116;91;107 08:40:52 INFO - PROCESS | 1664 | |6;imaging-darkroom;94;97;96;96;100;95;96;106;96;95 08:40:52 INFO - PROCESS | 1664 | |7;imaging-desaturate;79;134;141;91;93;90;91;91;93;99 08:40:52 INFO - PROCESS | 1664 | |8;json-parse-financial;53;57;60;54;56;58;57;57;57;59 08:40:52 INFO - PROCESS | 1664 | |9;json-stringify-tinderbox;78;89;59;95;105;104;99;104;101;69 08:40:52 INFO - PROCESS | 1664 | |10;stanford-crypto-aes;86;89;87;83;88;87;90;87;87;87 08:40:52 INFO - PROCESS | 1664 | |11;stanford-crypto-ccm;138;141;142;133;136;163;156;160;156;141 08:40:52 INFO - PROCESS | 1664 | |12;stanford-crypto-pbkdf2;171;173;171;173;166;239;235;190;221;240 08:40:52 INFO - PROCESS | 1664 | |13;stanford-crypto-sha256-iterative;70;68;69;82;92;86;93;81;69;79 08:40:52 INFO - PROCESS | 1664 | __end_tp_report 08:40:52 INFO - PROCESS | 1664 | __start_cc_report 08:40:52 INFO - PROCESS | 1664 | _x_x_mozilla_cycle_collect,1039 08:40:52 INFO - PROCESS | 1664 | __end_cc_report 08:40:52 INFO - PROCESS | 1664 | __startTimestamp1471534852204__endTimestamp 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | ------- Summary: start ------- 08:40:52 INFO - PROCESS | 1664 | Number of tests: 14 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#0] ai-astar Cycles:10 Average:114.10 Median:116.00 stddev:3.70 (3.2%) stddev-sans-first:2.50 08:40:52 INFO - PROCESS | 1664 | Values: 106.0 115.0 109.0 116.0 116.0 115.0 118.0 116.0 116.0 114.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#1] audio-beat-detection Cycles:10 Average:139.20 Median:139.50 stddev:26.76 (19.2%) stddev-sans-first:28.38 08:40:52 INFO - PROCESS | 1664 | Values: 141.0 112.0 175.0 178.0 112.0 128.0 128.0 109.0 171.0 138.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#2] audio-dft Cycles:10 Average:221.90 Median:216.50 stddev:27.57 (12.7%) stddev-sans-first:27.18 08:40:52 INFO - PROCESS | 1664 | Values: 193.0 207.0 205.0 232.0 222.0 271.0 211.0 200.0 209.0 269.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#3] audio-fft Cycles:10 Average:80.60 Median:60.50 stddev:32.43 (53.6%) stddev-sans-first:34.21 08:40:52 INFO - PROCESS | 1664 | Values: 71.0 80.0 75.0 141.0 60.0 59.0 59.0 61.0 140.0 60.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#4] audio-oscillator Cycles:10 Average:88.60 Median:70.50 stddev:31.00 (44.0%) stddev-sans-first:32.06 08:40:52 INFO - PROCESS | 1664 | Values: 69.0 77.0 152.0 70.0 72.0 79.0 110.0 57.0 71.0 129.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#5] imaging-gaussian-blur Cycles:10 Average:109.10 Median:112.50 stddev:20.06 (17.8%) stddev-sans-first:20.18 08:40:52 INFO - PROCESS | 1664 | Values: 91.0 87.0 107.0 133.0 88.0 133.0 138.0 116.0 91.0 107.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#6] imaging-darkroom Cycles:10 Average:97.10 Median:96.00 stddev:3.51 (3.7%) stddev-sans-first:3.54 08:40:52 INFO - PROCESS | 1664 | Values: 94.0 97.0 96.0 96.0 100.0 95.0 96.0 106.0 96.0 95.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#7] imaging-desaturate Cycles:10 Average:100.20 Median:91.00 stddev:20.33 (22.3%) stddev-sans-first:20.06 08:40:52 INFO - PROCESS | 1664 | Values: 79.0 134.0 141.0 91.0 93.0 90.0 91.0 91.0 93.0 99.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#8] json-parse-financial Cycles:10 Average:56.80 Median:57.00 stddev:2.10 (3.7%) stddev-sans-first:1.72 08:40:52 INFO - PROCESS | 1664 | Values: 53.0 57.0 60.0 54.0 56.0 58.0 57.0 57.0 57.0 59.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#9] json-stringify-tinderbox Cycles:10 Average:90.30 Median:73.50 stddev:16.30 (22.2%) stddev-sans-first:16.67 08:40:52 INFO - PROCESS | 1664 | Values: 78.0 89.0 59.0 95.0 105.0 104.0 99.0 104.0 101.0 69.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#10] stanford-crypto-aes Cycles:10 Average:87.10 Median:87.00 stddev:1.85 (2.1%) stddev-sans-first:1.92 08:40:52 INFO - PROCESS | 1664 | Values: 86.0 89.0 87.0 83.0 88.0 87.0 90.0 87.0 87.0 87.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#11] stanford-crypto-ccm Cycles:10 Average:146.60 Median:149.00 stddev:10.96 (7.4%) stddev-sans-first:11.17 08:40:52 INFO - PROCESS | 1664 | Values: 138.0 141.0 142.0 133.0 136.0 163.0 156.0 160.0 156.0 141.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:197.90 Median:205.50 stddev:31.87 (15.5%) stddev-sans-first:32.28 08:40:52 INFO - PROCESS | 1664 | Values: 171.0 173.0 171.0 173.0 166.0 239.0 235.0 190.0 221.0 240.0 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - PROCESS | 1664 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:78.90 Median:81.50 stddev:9.60 (11.8%) stddev-sans-first:9.62 08:40:52 INFO - PROCESS | 1664 | Values: 70.0 68.0 69.0 82.0 92.0 86.0 93.0 81.0 69.0 79.0 08:40:52 INFO - PROCESS | 1664 | -------- Summary: end -------- 08:40:52 INFO - PROCESS | 1664 | 08:40:52 INFO - TEST-INFO | 1664: exit 0 08:40:53 INFO - TEST-OK | kraken | took 60851ms 08:40:53 INFO - SUITE-END | took 1174s 08:40:53 INFO - Completed test suite (00:19:34) 08:40:53 INFO - javascript benchmark 08:40:53 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7413.559888721931, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3176.6664500227475, 3378.611459682136, 3392.983035084824, 3419.1964888251273, 3429.7599168058237, 5585.078462053766, 5706.857328566783, 5716.1711551824965, 5742.483176514118, 5818.3308919474275, 4370.1915145697985, 4934.013197360533, 4946.802127914879, 5725.7995970141055, 5903.085021821625, 4321.762303073329, 5073.84778456645, 5205.9219111713355, 5286.001166029675, 5388.865278368033, 4650.000249946261, 5116.795328186868, 5305.840824775263, 5346.331708536433, 5380.24676545284, 3693.3905905525558, 4617.399738034034, 5124.28260043596, 5197.506236907488, 5289.18017707256, 5045.798168073309, 5215.061288967984, 5222.060029194743, 5245.6852588844795, 5259.86850328741, 5121.103806833827, 5198.506141916512, 5214.60890433219, 5221.843344699665, 5246.658967167122, 5253.684778913277, 5612.5229355504425, 5731.426857314277, 5812.651240925558, 5852.502537284336, 6192.566520343577, 6261.311255761862, 6276.560640755149, 6278.87442251157, 6296.6536840473755, 6154.661493617849, 6245.063240513914, 6279.780207692755, 6298.244210694746, 6306.590071645328, 5855.473007429309, 5931.258592675916, 5956.672383018932, 5957.374475680034, 5971.4028597140805, 6227.782027629011, 6289.088082228142, 6290.559660823698, 6305.96847015762, 6311.96844015777, 6017.548683848729, 6180.536459765445, 6211.440970312694, 6213.844653883599, 6228.750849965951, 6116.640127388518, 6156.230471191101, 6220.0, 6220.875582488325, 6226.5641405102115, 6133.5182902793495, 6202.28673702521, 6214.40963108504, 6216.316205217422, 6228.065790131516, 6253.312135665074, 6279.717412716439, 6285.717142728588, 6298.905516417258, 6300.779472718525, 4849.418069831572, 4925.187344088257, 4941.258811178352, 4980.551750342486, 4991.950080499221, 4405.118976204772, 4423.800928958204, 4445.622122119591, 4461.442319710036, 4475.216837053503, 5557.027520183951, 5696.857578560569, 5945.524358051345, 5949.970250148722, 5994.910076348859, 6208.596441231305, 6210.5652604317265, 6278.246610406781, 6279.215098112736, 6280.900842352661, 5868.383819698955, 5940.376260492672, 5958.344582095966, 5972.223610930551, 5977.491913187341, 5453.318335208099, 5454.91817622736, 5471.534919531884, 5488.643238189505, 5503.11950087984, 6182.505399567934, 6277.1525844010475, 6308.274548426898, 6319.210098737658, 6319.8104056878365, 6199.845003874939, 6219.129321895029, 6226.1905952225925, 6250.1874756281395, 6267.811965641038, 6353.96823015882, 6377.394147555975, 6393.776217832354, 6397.168368112116, 6407.71165297572, 6114.0, 6178.969105154445, 6201.658908760061, 6233.940230160974, 6248.906266406098, 6157.0, 6224.844378890382, 6267.9344511432255, 6273.529485288713, 6279.089532017923, 6170.167027451236, 6195.411435913581, 6221.564490485623, 6226.937730622817, 6242.188515493139, 6046.697665116814, 6124.112003759519, 6195.977663685441, 6206.658633775005, 6246.031865060922, 4380.8685739427865, 4788.473267940593, 4887.34020907173, 5023.623228257822, 6075.848103797263, 6163.229596300463, 6186.4741496973265, 6187.938120618916, 6196.380361963767, 6210.968945155245, 5940.435658612425, 6005.489533389711, 6041.848953776191, 6092.147099405998, 6110.511159107172], "value": 5671.548750224794, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [459.3821310337596, 472.7187323542493, 528.4688887667895, 539.9865003374917, 550.2846299810246, 30843.84578077109, 40970.38544421836, 41038.17923641526, 41069.97325066875, 41145.0, 41678.0, 42367.0, 42395.0, 42442.57557424425, 42488.0, 9708.902910970888, 9850.753731156743, 9875.234934218395, 9877.0, 9891.653792117277, 8444.451110677817, 9780.266480013992, 9831.459269740162, 9836.508174591278, 9842.360246583985, 9779.55991980359, 9821.70534883951, 9822.508874556279, 9864.062914023192, 9869.753256168582, 9766.755831104208, 9785.168260697848, 9811.166050885684, 9874.703758887244, 9877.703668889873, 9660.37207581512, 9757.414555126716, 9775.266854985905, 9790.75523111928, 9795.510224488748, 39833.0, 40013.79993100016, 40135.39796903049, 40250.98745062735, 40384.19231615381, 2634.5126151662002, 3275.3613045456145, 3322.883699070545, 3504.9649503504893, 3533.4346504559403, 29936.203827770187, 30339.0, 30413.0, 31312.686873131206, 31394.686053139405, 3127.4526957782523, 3157.494800831856, 3181.077487528614, 3184.1561986073707, 3255.186203449138, 474035.51928961574, 508312.0, 522059.9999999962, 643715.0, 645212.0, 60917.69541152354, 61275.69362153161, 61298.69350653218, 61354.69322653358, 61385.386146137964, 34660.82669586636, 35253.47119793205, 63051.05423418652, 63414.0, 63658.0, 16590.917045414695, 16697.83302166987, 16808.495745127664, 16815.91592042032, 16853.747193792104, 12778.872211277954, 12810.80783788244, 12913.677158070936, 12932.030097742707, 12965.805512917314, 19164.71252931207, 19167.616647666968, 19183.136758845885, 19197.232110715693, 19233.51916202106, 8050.758477245575, 8173.959130204311, 8178.141295164041, 8206.630701618442, 8208.712695055763, 856.208007592974, 993.1607791416242, 994.8607194992562, 1001.3891526169031, 1052.952617132231, 29413.676384562747, 30413.239669008453, 30524.84737576298, 30686.38627227443, 31287.68712312848, 959.510649568725, 1020.7193021919031, 1030.7886883188928, 1034.4000479721744, 1035.2028937718067, 12439.315837628836, 12764.680882977815, 13420.127691700009, 14249.501267455797, 15776.921115394349, 499935.0, 620709.0, 622367.0, 623553.0, 623723.0, 59477.70261148753, 59963.400365996655, 59964.70017649971, 60004.69997649984, 60266.0, 1351.216294549159, 1360.7890776929592, 1392.8746412822895, 1396.427464739452, 1401.7897315402772, 26334.604980925684, 28691.28271793222, 29445.26386840346, 30997.646026173068, 31265.68734312628, 52812.471875282296, 53041.7347913258, 53090.73454632702, 53758.46241537535, 54514.0, 568041.0, 569807.0, 570425.0, 570998.0, 574025.0, 27288.04491842776, 27667.861660691568, 27684.169474915783, 27749.722502775523, 27811.860940695165, 48703.756481218785, 49025.01949961052, 49042.0, 49189.03243870205, 49750.0, 39648.40527392034, 40036.799816000734, 40516.0, 40667.59332406638, 40742.24798507124, 37906.81046594749, 39893.80318590447, 39943.40084898787, 41001.179976400905, 41245.58754412417, 38087.80956095202, 38476.653317133765, 39036.609633903296, 39514.604853951096, 39531.40702889401, 34398.312033759685, 35849.82075089608, 41123.0, 41959.370609441496, 43456.565434345255, 31863.68136318607, 33013.83493082519, 33066.0, 33120.0, 33323.50014749829], "value": 20296.70036025081, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [316.4635942078178, 366.41190888623777, 376.27754710954974, 384.0, 405.50528355406414, 20509.282175123873, 20531.692024619624, 21119.47201319964, 21342.99999999998, 21547.46131346717, 11833.940830295858, 12071.33607651581, 12144.574939877106, 12177.695557611065, 13433.596992090228, 5311.840644780644, 5443.727813609304, 5451.3458384993855, 5485.670859748428, 5547.55619550437, 3826.7321287509885, 5437.102878025141, 5785.3925337839555, 6046.304674962392, 6092.878142437148, 6088.695565221743, 6135.110408990694, 6143.938560614403, 6154.476869466101, 6162.9383706163035, 6339.587926784744, 6668.699908504104, 6716.731330746764, 6724.0, 6738.35985581369, 5651.2935883014625, 5835.4748072673665, 5874.9118763218585, 5880.4119588041285, 5900.822975310747, 13299.66750831237, 17517.0, 17531.386401476015, 26613.600795988077, 26714.73285267142, 2268.6143355629583, 2303.4817166137655, 2353.7175538935267, 2935.5890175375466, 2977.285451491648, 9987.75030624233, 10149.543270552844, 10163.542640581118, 10217.33587316822, 10337.0, 1630.584201028742, 1746.777255920848, 1900.363378268268, 1915.4636701723539, 1944.8152425519554, 77113.22886771116, 113332.0, 125105.74894251033, 125611.99999999908, 126091.0, 10926.235163538477, 11151.72120696989, 11310.60412885545, 11547.307161570332, 11586.71033224176, 14102.153870767786, 14180.0, 14250.429982800779, 14336.784948225784, 14344.856551434561, 7113.110861142357, 8271.95864020676, 8536.591462408633, 8691.782705432415, 8712.869306960401, 8562.828743425096, 8606.096359882247, 8633.95683021581, 8696.826063478695, 8801.955990220007, 4448.7108337957925, 4532.27483602622, 4533.682642215013, 4589.173948689201, 4644.49197433389, 1595.2900959073334, 1671.9049022890026, 1688.0715606416668, 1932.603816217672, 2005.7793642699291, 929.3401684803865, 949.2832911152174, 994.2791476179711, 1000.1848493477793, 1013.3919648211162, 20829.375118746462, 21031.94840257981, 21051.368458946257, 21187.60998240274, 21252.831094289962, 795.9482633628795, 913.0276255787564, 921.5530467723149, 964.2141654551658, 982.2142286171035, 10026.69919902404, 10400.791984160274, 11069.5572177112, 11120.666380008613, 11141.164412669083, 607942.0, 614702.0, 618105.0, 626485.0, 633639.0, 126184.84537886626, 134132.0, 139825.60174398328, 150645.0, 154570.0, 948.1608776232946, 981.3915372469115, 989.3816364772017, 990.0396615283164, 1026.4559783315005, 15852.0, 18687.719684204476, 19534.120964556914, 19584.31454899072, 19592.628516003744, 41821.79089104535, 59960.700196498736, 60739.48151296253, 60846.08730869129, 61859.690701546206, 88779.66830497677, 88906.0, 89942.0, 89983.0, 89987.0, 6803.251642319242, 8016.717325227935, 8082.272595466201, 8212.63043163071, 8222.671093156447, 11335.376554289593, 11706.180567360203, 11732.0, 13007.479700811862, 13366.198028118344, 11096.056835169102, 11295.661130166109, 11340.489677964346, 11501.597444089417, 11521.884781152416, 11026.393548354918, 11173.664790055986, 11213.60752373663, 11393.145514086642, 11591.710207244887, 11388.487518061873, 11547.653570392902, 11550.553037080617, 11594.0, 11629.0, 7911.881321780293, 7999.760007199793, 8062.5890469168835, 8187.59618651687, 8275.462094963808, 10848.457577120955, 11311.490982905954, 11317.773644527228, 11337.979581837673, 11338.659840204808], "value": 9486.501603769828, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1515.6589767302355, 1529.3041666041952, 1761.6476704659071, 1781.7238328059154, 1874.41893013166, 7338.266173382659, 7761.805954851132, 8458.196471335228, 8838.292936565067, 8846.646134154642, 8516.531590762506, 8695.347848911326, 8701.521416322099, 8706.434081784679, 8736.43213191142, 2343.097907305691, 2378.702662167229, 2379.8929048192786, 2383.1301574925114, 2387.8089752819733, 2334.3580515358326, 2358.5518751437257, 2382.1424287256573, 2383.285014495653, 2389.4145934246135, 1983.1769815526538, 2223.8888055597236, 2366.8934897929635, 2373.9287821365388, 2376.940576485584, 2085.405659387075, 2343.6250199968094, 2356.1871154451774, 2361.49227915998, 2364.8226383021342, 1923.6441258367247, 1934.9709754353696, 2336.8013718833918, 2347.5891718949115, 2349.271725765001, 7970.043594768665, 8034.517928924283, 8713.738587842376, 8751.474911505331, 8761.956190219073, 5140.177571588528, 5213.061648903196, 5298.417174110845, 5303.071962406563, 5316.840494785162, 3516.6659167379057, 3577.6422357764277, 3636.5272514573203, 3643.7429086964953, 3715.145516531186, 1050.2298924528907, 1084.6312253833655, 1092.8688557373166, 1102.9613963511238, 1108.7505311304972, 11266.985971262544, 11322.943385283103, 11346.71633209168, 11411.54353825846, 11428.085753139729, 4548.636109111263, 4562.0, 4745.078243311465, 4752.287156926489, 4767.022760334124, 9685.951570242245, 9780.070893265129, 9808.460534670661, 9808.803823923625, 9841.655542055994, 5259.789608415697, 5282.0, 5301.761420736076, 5309.123994540934, 5310.92033619496, 4354.390385346054, 4686.390769199982, 4814.422269327703, 4865.051314993542, 4868.659193856467, 3440.2431465077643, 3823.3118038752737, 3861.687026411034, 3900.7854567998465, 4010.939835902464, 1132.5243397772956, 1298.6298904812083, 1313.7832257677376, 1319.3535167767916, 1324.708564115893, 887.9556022198864, 914.9908500915038, 918.8300164469595, 923.6905636611676, 935.4901578639658, 5881.735321910439, 5882.735276912549, 5914.319853216849, 5997.850053748692, 6217.098520714561, 904.3036861616519, 915.1306259053925, 963.0995019656643, 980.3284749946309, 998.670438755209, 3912.315344814646, 3923.2153569286256, 3925.6859451244404, 4060.6954478413645, 4071.633552980246, 10338.172946164288, 10699.572017119384, 10706.46467676613, 10715.83926241107, 10732.356058636507, 10632.362058276529, 10681.465926703633, 10687.786244275227, 10718.73203169927, 10780.730481738019, 7649.502782319243, 8054.23484768946, 8095.919040809635, 8240.299574536111, 8263.256306932404, 4981.551660350586, 5951.1168887874965, 5997.31030931431, 6086.908696369646, 6117.0, 8187.795305117182, 9322.161005509537, 9766.56050477716, 9922.950385248316, 9937.950310248403, 7849.4897831640765, 7869.48848324857, 8153.0, 9734.464604446823, 10199.490025498548, 6053.909191362045, 6312.242530896322, 6351.841203969753, 6924.515283930278, 7588.392928565591, 8296.377771667028, 8361.080281168945, 8376.0, 8388.706395276136, 8404.0, 7362.6318684066655, 7505.099388073466, 7520.435967302365, 7585.2035536267895, 7603.353714934293, 6676.699548520425, 7233.276672332935, 7369.286337028272, 7376.225496322809, 7479.289467500579, 5838.1826544282985, 6921.2386637468835, 7008.789736307919, 7009.334113259232, 7014.368706816411, 4435.800388982439, 5012.498750124958, 5047.772850221675, 5064.316317297118, 5108.795648174031, 4193.9370909435775, 4941.75291235444, 5032.974835125801, 5100.872478188075, 5121.0], "value": 4520.1418176935085, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [277.555910543131, 307.4266492990572, 316.7172949554306, 317.2861062609129, 320.70014536408445, 5085.364329458817, 5341.893162136755, 5478.205660179282, 5622.8313150605445, 5787.334456537499, 4261.573842615745, 4829.0824743298745, 5688.886222275562, 5706.1440783882435, 5710.77156913724, 4336.97831510842, 4351.456067991501, 4367.279398899178, 4378.1462614790125, 4385.802638881258, 4202.159568086379, 4307.332363483665, 4341.6309613682715, 4374.868753937387, 4377.934330985022, 3726.6646001859826, 4120.361343991671, 4279.03721662625, 4301.741895486281, 4303.848075962019, 4290.592393722592, 4300.5269420363575, 4321.762303073329, 4334.523202447728, 4366.868993930156, 3481.35594914939, 3731.5708693500324, 3747.7563958342894, 3753.972854658481, 3755.9295600753926, 4759.428868535763, 4937.5561994205145, 5496.900619876041, 5556.277683901108, 5584.776608935637, 4090.9999999999704, 4329.588689074533, 4662.976685116587, 4971.726555039471, 4973.836381174201, 5788.350320158776, 5991.861546306188, 6033.8189854304, 6037.698115094227, 6081.0, 4066.573009833984, 4074.9185016299507, 4075.9388609170887, 4077.756284333277, 4105.363668631367, 5856.97071514644, 6182.505399568024, 6381.3937675920715, 6407.487401007955, 6435.259945106326, 3806.657400833938, 3823.5602905665646, 3938.350172221609, 4157.378622337291, 4180.47744031996, 3196.376706542202, 3480.930381392358, 4201.458117838724, 4227.387028880857, 4260.957390426118, 4483.775811209426, 4565.9270071533165, 4934.55588996992, 4958.355413796184, 5002.199648056367, 5221.242919776611, 5304.575633949275, 6106.6336019838955, 6128.846778830565, 6176.270644219626, 1363.541011118094, 1399.5661344983089, 1403.4526534651493, 1406.7538180818522, 1408.197327523302, 818.8771684247411, 840.5461051032374, 854.5043874552745, 856.1695155698962, 858.5406807358158, 4233.640140588023, 4364.9127017460105, 4641.327007583882, 4813.735244561512, 4863.610911127102, 4479.529649386833, 4635.0, 4720.551547602972, 4821.855344339676, 5251.658642188246, 4443.578055022426, 4457.866264012085, 4467.872489257533, 4732.503087175797, 4750.809967601326, 2869.684334723179, 3265.6081270247723, 3288.408086544445, 3311.337732453519, 3314.93370132596, 4886.828960986349, 5776.653400795882, 5944.494717948936, 6489.740410383626, 6495.271985765895, 5102.617303702237, 5587.552995760329, 5888.322842873039, 6207.503399728011, 6434.292227854932, 5168.81909133186, 5679.488846003879, 5763.94236057634, 6477.664003038345, 6507.663715753037, 5015.799368025238, 5299.2316114164005, 5587.7485513152815, 5897.5281977440845, 6303.306636269915, 5129.8717532062, 5662.687327913217, 5980.222571065734, 6132.191003653844, 6168.629882207082, 6437.25971513282, 6439.195100612424, 6452.225732911893, 6460.25707043696, 6493.902591461037, 3558.2349794794245, 3804.391297392404, 3945.408188771707, 4000.299947509116, 4013.4381186634478, 4853.587445067209, 5673.546116310603, 6134.509239260759, 6169.259688837368, 6234.812955611339, 5032.7483625819295, 6033.2805150531885, 6037.547183961133, 6044.881696885915, 6053.0, 5500.202470641814, 5584.553235741049, 5664.688442135722, 5954.880902382015, 5995.670238136944, 5153.871153221199, 5285.550728188147, 5479.821703411932, 5821.330546986981, 5913.58604897653, 4993.575546078624, 5257.921131183112, 5656.236408084856, 6004.849878753066, 6043.486303664062, 5410.377806552139, 5773.393793651606, 5849.824505264849, 5867.618604790675, 5894.793682221101], "value": 4239.996978381502, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [611.251217258858, 614.6527212125148, 659.8350412396901, 728.5555810955316, 772.6677528662675, 17024.744628830562, 17722.46832595021, 17728.29086836525, 18258.99575523349, 18271.269149234016, 16273.186340682978, 16374.672506549861, 16580.005199687996, 16592.336306547724, 16601.50195494137, 681.4616453002147, 835.3985130705897, 869.0397111192104, 872.5593575244525, 873.1792115411524, 833.6373677450298, 849.9490030598184, 863.8833757442759, 865.26020252684, 866.0819531296845, 901.8061116859874, 910.41733290694, 912.069688917304, 913.8400779863531, 915.6474757218485, 882.382332367339, 894.2443635128307, 907.7685190276503, 908.4730856103511, 909.5134103254793, 671.835400326923, 675.2538445018282, 676.4149011105359, 677.0217036382429, 678.9849175482635, 15320.310586023656, 15384.461543845911, 15392.922495425324, 15441.922790385976, 15467.994580352353, 14325.498607548685, 14338.928305358511, 14382.35279412429, 14403.71192576153, 14478.855211447855, 9789.0, 11918.582849600223, 11941.283522988648, 12009.819852702216, 12035.398230088547, 3826.2921359548573, 3829.7319187656876, 3850.634189751969, 3869.7678139311734, 4013.8795836124964, 100758.0, 103561.48219258855, 105282.0, 116551.83448165495, 124097.37951310186, 11039.72400689973, 11083.002529772359, 11214.271072380268, 11268.042216411533, 11355.545778168946, 21752.0, 21807.127714891227, 21939.122435102738, 21974.0, 22092.226772062902, 8075.192480751995, 8159.714409995621, 8186.017677878693, 8233.135520770353, 8322.334213262924, 4613.400257966443, 4639.211334073216, 4688.249880019249, 4745.881352966204, 4768.856934291976, 3225.548423220751, 3655.5065066216252, 3765.4351847223134, 3784.962150378461, 3794.829232684536, 569.6553585081049, 574.1932584718477, 688.2601203706037, 693.6739732325799, 695.2109355881112, 533.4985113992834, 666.7533012785301, 681.5433659448181, 685.766839274649, 698.7274962764526, 8057.677692892219, 9102.271818254523, 9658.565364558612, 9745.074217949283, 9892.889392208408, 574.1072632057108, 592.7540070870626, 615.6552330694825, 653.6698967021719, 676.8477092654114, 4493.460784705856, 4647.7451088206, 4763.2140696784645, 4765.237561990134, 4786.44955830077, 98223.52664710036, 139328.30335848255, 152481.0, 160097.0, 165361.0, 119936.0, 146330.0, 146880.5311946888, 150541.99999999782, 151535.24232378768, 78494.60752696314, 80411.99999999884, 104181.45641066613, 124111.0, 127623.0, 7541.698332066656, 9630.614775408905, 9955.850662240216, 10037.347572408062, 10150.796984060129, 57465.4140563684, 57486.562835929435, 61690.766184676955, 66168.00747988687, 67625.97122086346, 86491.0, 94735.0, 99358.5032074835, 100054.4997275009, 100228.99542009264, 10646.680599582025, 12399.628011159679, 13025.427095748682, 13071.215727056408, 13288.136271142344, 14673.413063477768, 14830.332635031235, 14836.18400987956, 14874.702505949605, 14901.92549037248, 13709.520166794115, 13777.173369597856, 13884.09753366028, 13918.09532380392, 14024.649383765487, 13764.380602872694, 13939.581812545639, 13951.720965580835, 14183.432662693376, 14362.425502979764, 13137.540186093442, 13503.39234734459, 13589.184648921097, 13703.657408564866, 13940.651483712989, 10926.289791163548, 11209.887901120885, 11380.772384552098, 11424.428778561205, 11551.249168804, 9506.572204250964, 9926.503674816375, 11278.266912650652, 11381.772364552828, 11625.0], "value": 7931.667206818958, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1608.4, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 115.0, 109.0, 116.0, 116.0, 115.0, 118.0, 116.0, 116.0, 114.0], "value": 114.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 112.0, 175.0, 178.0, 112.0, 128.0, 128.0, 109.0, 171.0, 138.0], "value": 139.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [193.0, 207.0, 205.0, 232.0, 222.0, 271.0, 211.0, 200.0, 209.0, 269.0], "value": 221.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 80.0, 75.0, 141.0, 60.0, 59.0, 59.0, 61.0, 140.0, 60.0], "value": 80.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 77.0, 152.0, 70.0, 72.0, 79.0, 110.0, 57.0, 71.0, 129.0], "value": 88.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [91.0, 87.0, 107.0, 133.0, 88.0, 133.0, 138.0, 116.0, 91.0, 107.0], "value": 109.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 97.0, 96.0, 96.0, 100.0, 95.0, 96.0, 106.0, 96.0, 95.0], "value": 97.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 134.0, 141.0, 91.0, 93.0, 90.0, 91.0, 91.0, 93.0, 99.0], "value": 100.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 57.0, 60.0, 54.0, 56.0, 58.0, 57.0, 57.0, 57.0, 59.0], "value": 56.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 89.0, 59.0, 95.0, 105.0, 104.0, 99.0, 104.0, 101.0, 69.0], "value": 90.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 89.0, 87.0, 83.0, 88.0, 87.0, 90.0, 87.0, 87.0, 87.0], "value": 87.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [138.0, 141.0, 142.0, 133.0, 136.0, 163.0, 156.0, 160.0, 156.0, 141.0], "value": 146.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 173.0, 171.0, 173.0, 166.0, 239.0, 235.0, 190.0, 221.0, 240.0], "value": 197.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 68.0, 69.0, 82.0, 92.0, 86.0, 93.0, 81.0, 69.0, 79.0], "value": 78.9, "unit": "score"}]}]} 08:40:53 INFO - Return code: 0 08:40:53 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:40:53 ERROR - # TBPL SUCCESS # 08:40:53 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:40:53 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:40:53 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:40:53 INFO - 2016-08-18 08:40:53.534 screenresolution[1669:10496] starting screenresolution argv=screenresolution get 08:40:53 INFO - 2016-08-18 08:40:53.537 screenresolution[1669:10496] Display 0: 1600x1200x32@60 08:40:53 INFO - 2016-08-18 08:40:53.543 screenresolution[1670:10499] starting screenresolution argv=screenresolution list 08:40:53 INFO - Available Modes on Display 0 08:40:53 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:40:53 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:40:53 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:40:53 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:40:53 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:40:53 INFO - Intel Iris: 08:40:53 INFO - Chipset Model: Intel Iris 08:40:53 INFO - Type: GPU 08:40:53 INFO - Bus: Built-In 08:40:53 INFO - VRAM (Dynamic, Max): 1536 MB 08:40:53 INFO - Vendor: Intel (0x8086) 08:40:53 INFO - Device ID: 0x0a2e 08:40:53 INFO - Revision ID: 0x0009 08:40:53 INFO - Displays: 08:40:53 INFO - Display: 08:40:53 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:40:53 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:40:53 INFO - Display Serial Number: 1600x1200 60 08:40:53 INFO - Main Display: Yes 08:40:53 INFO - Mirror: Off 08:40:53 INFO - Online: Yes 08:40:53 INFO - Rotation: Supported 08:40:53 INFO - Return code: 0 08:40:53 INFO - Running post-action listener: _resource_record_post_action 08:40:53 INFO - [mozharness: 2016-08-18 15:40:53.781264Z] Finished run-tests step (success) 08:40:53 INFO - Running post-run listener: _resource_record_post_run 08:40:53 INFO - Total resource usage - Wall time: 1209s; CPU: 54.0%; Read bytes: 37049344; Write bytes: 707362304; Read time: 242; Write time: 2055 08:40:53 INFO - TinderboxPrint: CPU usage
54.5% 08:40:53 INFO - TinderboxPrint: I/O read bytes / time
37,049,344 / 242 08:40:53 INFO - TinderboxPrint: I/O write bytes / time
707,362,304 / 2,055 08:40:53 INFO - TinderboxPrint: CPU idle
2,201.2 (45.5%) 08:40:53 INFO - TinderboxPrint: CPU system
980.5 (20.3%) 08:40:53 INFO - TinderboxPrint: CPU user
1,656.0 (34.2%) 08:40:53 INFO - TinderboxPrint: Swap in / out
442,146,816 / 0 08:40:53 INFO - install - Wall time: 34s; CPU: 55.0%; Read bytes: 411644416; Write bytes: 409763840; Read time: 30108; Write time: 888 08:40:53 INFO - run-tests - Wall time: 1176s; CPU: 54.0%; Read bytes: 29117440; Write bytes: 296132096; Read time: 174; Write time: 1159 08:40:54 INFO - Running post-run listener: _upload_blobber_files 08:40:54 INFO - Blob upload gear active. 08:40:54 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:40:54 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 08:40:54 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', 'Autoland', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:40:54 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 Autoland -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:40:54 INFO - (blobuploader) - INFO - Open directory for files ... 08:40:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 08:40:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:40:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:40:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 08:40:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:40:55 INFO - (blobuploader) - INFO - Done attempting. 08:40:55 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 08:40:55 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:40:55 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:40:56 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 08:40:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:40:56 INFO - (blobuploader) - INFO - Done attempting. 08:40:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:40:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:40:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:40:58 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:40:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:40:58 INFO - (blobuploader) - INFO - Done attempting. 08:40:58 INFO - (blobuploader) - INFO - Iteration through files over. 08:40:58 INFO - Return code: 0 08:40:58 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:40:58 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:40:58 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/e53111ece41303d41742a58bf4fda58387dea97bceab9d77bc269c3719ac5c2902f87a03b7cd068c630e450fe27f8c54182e9f2c5c0612fec7f30ef570739321", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/dde1cb54a9562641a21db59bfe9fca648bb623e214a84337eb7ddfe99cb7d24e5fd4a5a71f6fe063dd8ede8d1b389e69c24d2f83d25487c3f9b04baf65009f5a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a2b65f6494a4cb48c19ebb16822a5b975676bfb268e13c841b486b390a20a076efa5309e53609bf3ac8b67eec1cdc5eae16cf9c644a0e7c91160cc978169e81b"} 08:40:58 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:40:58 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:40:58 INFO - Contents: 08:40:58 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/e53111ece41303d41742a58bf4fda58387dea97bceab9d77bc269c3719ac5c2902f87a03b7cd068c630e450fe27f8c54182e9f2c5c0612fec7f30ef570739321", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/dde1cb54a9562641a21db59bfe9fca648bb623e214a84337eb7ddfe99cb7d24e5fd4a5a71f6fe063dd8ede8d1b389e69c24d2f83d25487c3f9b04baf65009f5a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a2b65f6494a4cb48c19ebb16822a5b975676bfb268e13c841b486b390a20a076efa5309e53609bf3ac8b67eec1cdc5eae16cf9c644a0e7c91160cc978169e81b"} 08:40:58 INFO - Running post-run listener: copy_logs_to_upload_dir 08:40:58 INFO - Copying logs to upload dir... 08:40:58 INFO - mkdir: /builds/slave/test/build/upload/logs 08:40:58 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1268.421019 ========= master_lag: 0.14 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2016-08-18 08:40:59.077090) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-18 08:40:59.080866) ========= 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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners TMPDIR=/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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/Autoland/sha512/e53111ece41303d41742a58bf4fda58387dea97bceab9d77bc269c3719ac5c2902f87a03b7cd068c630e450fe27f8c54182e9f2c5c0612fec7f30ef570739321", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/dde1cb54a9562641a21db59bfe9fca648bb623e214a84337eb7ddfe99cb7d24e5fd4a5a71f6fe063dd8ede8d1b389e69c24d2f83d25487c3f9b04baf65009f5a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a2b65f6494a4cb48c19ebb16822a5b975676bfb268e13c841b486b390a20a076efa5309e53609bf3ac8b67eec1cdc5eae16cf9c644a0e7c91160cc978169e81b"} build_url:https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011013 build_url: 'https://queue.taskcluster.net/v1/task/KjYbN7jETTmpEnl5k_H7nQ/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/e53111ece41303d41742a58bf4fda58387dea97bceab9d77bc269c3719ac5c2902f87a03b7cd068c630e450fe27f8c54182e9f2c5c0612fec7f30ef570739321", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/dde1cb54a9562641a21db59bfe9fca648bb623e214a84337eb7ddfe99cb7d24e5fd4a5a71f6fe063dd8ede8d1b389e69c24d2f83d25487c3f9b04baf65009f5a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a2b65f6494a4cb48c19ebb16822a5b975676bfb268e13c841b486b390a20a076efa5309e53609bf3ac8b67eec1cdc5eae16cf9c644a0e7c91160cc978169e81b"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-18 08:40:59.118620) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-18 08:40:59.119030) ========= 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.jEw4pZcUIn/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.bTMWr9IRDL/Listeners TMPDIR=/var/folders/87/tdvlw3rj6yb17xk_t0qxk6xw00000w/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.005286 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-18 08:40:59.167403) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-18 08:40:59.167716) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-18 08:40:59.168019) ========= ========= Total master_lag: 0.28 =========