builder: autoland_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0183 starttime: 1471300416.0 results: success (0) buildid: 20160815124617 builduid: 13efb8ff66d74fcd800e78af9bffc413 revision: 90418dcd93dbcbe0166653878e04126df0712eba ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.004038) ========= master: http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.004528) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.004824) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.031812) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.032422) ========= 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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners TMPDIR=/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/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-15 15:33:36-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 8.26M=0.001s 2016-08-15 15:33:36 (8.26 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.132738 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.187755) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.188090) ========= 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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners TMPDIR=/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/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.020745 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.242574) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:36.242924) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev 90418dcd93dbcbe0166653878e04126df0712eba --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 90418dcd93dbcbe0166653878e04126df0712eba --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.DmMh6QMDzf/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.iQuEQwvW7F/Listeners TMPDIR=/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/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-15 15:33:36,317 truncating revision to first 12 chars 2016-08-15 15:33:36,317 Setting DEBUG logging. 2016-08-15 15:33:36,317 attempt 1/10 2016-08-15 15:33:36,317 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/90418dcd93db?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-15 15:33:37,001 unpacking tar archive at: autoland-90418dcd93db/testing/mozharness/ program finished with exit code 0 elapsedTime=0.957357 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:37.219424) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:37.219777) ========= script_repo_revision: 90418dcd93dbcbe0166653878e04126df0712eba ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:37.220203) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:37.220490) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-15 15:33:37.238557) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-08-15 15:33:37.238861) ========= /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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners TMPDIR=/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 15:33:37 INFO - MultiFileLogger online at 20160815 15:33:37 in /builds/slave/test 15:33:37 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 15:33:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:33:37 INFO - {'append_to_log': False, 15:33:37 INFO - 'base_work_dir': '/builds/slave/test', 15:33:37 INFO - 'blob_upload_branch': 'Autoland', 15:33:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:33:37 INFO - 'branch': 'Autoland', 15:33:37 INFO - 'buildbot_json_path': 'buildprops.json', 15:33:37 INFO - 'config_files': ('talos/mac_config.py',), 15:33:37 INFO - 'default_actions': ('clobber', 15:33:37 INFO - 'read-buildbot-config', 15:33:37 INFO - 'download-and-extract', 15:33:37 INFO - 'populate-webroot', 15:33:37 INFO - 'create-virtualenv', 15:33:37 INFO - 'install', 15:33:37 INFO - 'run-tests'), 15:33:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:33:37 INFO - 'download_minidump_stackwalk': True, 15:33:37 INFO - 'download_symbols': 'ondemand', 15:33:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:33:37 INFO - 'tooltool.py': '/tools/tooltool.py', 15:33:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:33:37 INFO - '/tools/misc-python/virtualenv.py')}, 15:33:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:33:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:33:37 INFO - 'installer_path': 'installer.exe', 15:33:37 INFO - 'log_level': 'info', 15:33:37 INFO - 'log_name': 'talos', 15:33:37 INFO - 'log_to_console': True, 15:33:37 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 15:33:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 15:33:37 INFO - 'opt_config_files': (), 15:33:37 INFO - 'pip_index': False, 15:33:37 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:33:37 INFO - 'cmd': ('bash', 15:33:37 INFO - '-c', 15:33:37 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:33:37 INFO - 'enabled': True, 15:33:37 INFO - 'halt_on_failure': False, 15:33:37 INFO - 'name': 'check_screen_resolution'},), 15:33:37 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:33:37 INFO - 'cmd': ('bash', 15:33:37 INFO - '-c', 15:33:37 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:33:37 INFO - 'enabled': True, 15:33:37 INFO - 'halt_on_failure': False, 15:33:37 INFO - 'name': 'check_screen_resolution'},), 15:33:37 INFO - 'run_cmd_checks_enabled': True, 15:33:37 INFO - 'sps_profile': False, 15:33:37 INFO - 'sps_profile_interval': 0, 15:33:37 INFO - 'suite': 'dromaeojs-e10s', 15:33:37 INFO - 'system_bits': '32', 15:33:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:33:37 INFO - 'title': 't-yosemite-r7-0183', 15:33:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:33:37 INFO - 'use_talos_json': True, 15:33:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:33:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:33:37 INFO - 'work_dir': 'build'} 15:33:37 INFO - [mozharness: 2016-08-15 22:33:37.431617Z] Running clobber step. 15:33:37 INFO - Running pre-action listener: _resource_record_pre_action 15:33:37 INFO - Running main action method: clobber 15:33:37 INFO - rmtree: /builds/slave/test/build 15:33:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:33:38 INFO - Running post-action listener: _resource_record_post_action 15:33:38 INFO - [mozharness: 2016-08-15 22:33:38.353744Z] Finished clobber step (success) 15:33:38 INFO - [mozharness: 2016-08-15 22:33:38.353876Z] Running read-buildbot-config step. 15:33:38 INFO - Running pre-action listener: _resource_record_pre_action 15:33:38 INFO - Running main action method: read_buildbot_config 15:33:38 INFO - Using buildbot properties: 15:33:38 INFO - { 15:33:38 INFO - "project": "", 15:33:38 INFO - "product": "firefox", 15:33:38 INFO - "script_repo_revision": "production", 15:33:38 INFO - "builddir": "autoland_yosemite_r7_test-dromaeojs-e10s", 15:33:38 INFO - "repository": "", 15:33:38 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 autoland talos dromaeojs-e10s", 15:33:38 INFO - "buildid": "20160815124617", 15:33:38 INFO - "pgo_build": "False", 15:33:38 INFO - "basedir": "/builds/slave/test", 15:33:38 INFO - "buildnumber": 123, 15:33:38 INFO - "slavename": "t-yosemite-r7-0183", 15:33:38 INFO - "master": "http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/", 15:33:38 INFO - "platform": "yosemite_r7", 15:33:38 INFO - "scheduler": "tests-autoland-macosx64-talos", 15:33:38 INFO - "branch": "autoland", 15:33:38 INFO - "repo_path": "integration/autoland", 15:33:38 INFO - "revision": "90418dcd93dbcbe0166653878e04126df0712eba", 15:33:38 INFO - "stage_platform": "macosx64", 15:33:38 INFO - "builduid": "13efb8ff66d74fcd800e78af9bffc413", 15:33:38 INFO - "slavebuilddir": "test" 15:33:38 INFO - } 15:33:38 INFO - Found installer url https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg. 15:33:38 INFO - Running post-action listener: _resource_record_post_action 15:33:38 INFO - [mozharness: 2016-08-15 22:33:38.357144Z] Finished read-buildbot-config step (success) 15:33:38 INFO - [mozharness: 2016-08-15 22:33:38.357266Z] Running download-and-extract step. 15:33:38 INFO - Running pre-action listener: _resource_record_pre_action 15:33:38 INFO - Running main action method: download_and_extract 15:33:38 INFO - mkdir: /builds/slave/test/build/tests 15:33: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')]} 15:33:38 INFO - trying https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json 15:33:38 INFO - Downloading https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 15:33:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json'}, attempt #1 15:33:39 INFO - Downloaded 1199 bytes. 15:33:39 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 15:33:39 INFO - Using the following test package requirements: 15:33:39 INFO - {u'common': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 15:33:39 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:33:39 INFO - u'firefox-51.0a1.en-US.mac.cppunittest.tests.zip'], 15:33:39 INFO - u'gtest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:33:39 INFO - u'firefox-51.0a1.en-US.mac.gtest.tests.zip'], 15:33:39 INFO - u'jittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:33:39 INFO - u'jsshell-mac.zip'], 15:33:39 INFO - u'mochitest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:33:39 INFO - u'firefox-51.0a1.en-US.mac.mochitest.tests.zip'], 15:33:39 INFO - u'mozbase': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 15:33:39 INFO - u'reftest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:33:39 INFO - u'firefox-51.0a1.en-US.mac.reftest.tests.zip'], 15:33:39 INFO - u'talos': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:33:39 INFO - u'firefox-51.0a1.en-US.mac.talos.tests.zip'], 15:33:39 INFO - u'web-platform': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:33:39 INFO - u'firefox-51.0a1.en-US.mac.web-platform.tests.zip'], 15:33:39 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 15:33:39 INFO - u'firefox-51.0a1.en-US.mac.xpcshell.tests.zip']} 15:33:39 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip'] for test suite category: common 15:33:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:33:39 INFO - trying https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 15:33:39 INFO - Downloading https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/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 15:33:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/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 15:33:40 INFO - Downloaded 16331650 bytes. 15:33:40 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 15:33:47 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip', u'firefox-51.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 15:33:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:33:47 INFO - trying https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 15:33:47 INFO - Downloading https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/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 15:33:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/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 15:33:48 INFO - Downloaded 16331650 bytes. 15:33:48 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/tests 15:33: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')]} 15:33:54 INFO - trying https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip 15:33:54 INFO - Downloading https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/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 15:33:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/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 15:33:55 INFO - Downloaded 14413719 bytes. 15:33:55 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/tests 15:33:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:33:56 INFO - trying https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 15:33:56 INFO - Downloading https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg 15:33:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg'}, attempt #1 15:33:58 INFO - Downloaded 111019485 bytes. 15:33:58 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 15:33:58 INFO - mkdir: /builds/slave/test/properties 15:33:58 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:33:58 INFO - Writing to file /builds/slave/test/properties/build_url 15:33:58 INFO - Contents: 15:33:58 INFO - build_url:https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 15:33:59 INFO - Running post-action listener: _resource_record_post_action 15:33:59 INFO - Running post-action listener: set_extra_try_arguments 15:33:59 INFO - [mozharness: 2016-08-15 22:33:59.586664Z] Finished download-and-extract step (success) 15:33:59 INFO - [mozharness: 2016-08-15 22:33:59.586793Z] Running populate-webroot step. 15:33:59 INFO - Running pre-action listener: _resource_record_pre_action 15:33:59 INFO - Running main action method: populate_webroot 15:33:59 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:33:59 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:33:59 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:33:59 INFO - '--tppagecycles', 15:33:59 INFO - '7'], 15:33:59 INFO - 'tests': ['tsvgm']}}, 15:33:59 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:33:59 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 15:33:59 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['dromaeo_css', 'kraken']}, 15:33:59 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 15:33:59 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:59 INFO - 'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:33:59 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:33:59 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:59 INFO - 'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['damp', 'tps']}, 15:33:59 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:59 INFO - 'tests': ['damp', 'tps']}, 15:33:59 INFO - 'g3': {'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['dromaeo_dom']}, 15:33:59 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:33:59 INFO - 'g4': {'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['basic_compositor_video']}, 15:33:59 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 15:33:59 INFO - 'other': {'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['a11yr', 15:33:59 INFO - 'ts_paint', 15:33:59 INFO - 'tpaint', 15:33:59 INFO - 'sessionrestore', 15:33:59 INFO - 'sessionrestore_no_auto_restore', 15:33:59 INFO - 'tabpaint']}, 15:33:59 INFO - 'other-e10s': {'tests': ['a11yr', 15:33:59 INFO - 'ts_paint', 15:33:59 INFO - 'tpaint', 15:33:59 INFO - 'sessionrestore', 15:33:59 INFO - 'sessionrestore_no_auto_restore', 15:33:59 INFO - 'tabpaint']}, 15:33:59 INFO - 'other-e10s_l64': {'tests': ['a11yr', 15:33:59 INFO - 'ts_paint', 15:33:59 INFO - 'tpaint', 15:33:59 INFO - 'sessionrestore', 15:33:59 INFO - 'sessionrestore_no_auto_restore', 15:33:59 INFO - 'tabpaint']}, 15:33:59 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 15:33:59 INFO - 'ts_paint', 15:33:59 INFO - 'tpaint', 15:33:59 INFO - 'sessionrestore', 15:33:59 INFO - 'sessionrestore_no_auto_restore', 15:33:59 INFO - 'tabpaint']}, 15:33:59 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['a11yr', 15:33:59 INFO - 'ts_paint', 15:33:59 INFO - 'tpaint', 15:33:59 INFO - 'sessionrestore', 15:33:59 INFO - 'sessionrestore_no_auto_restore', 15:33:59 INFO - 'tabpaint']}, 15:33:59 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['a11yr', 15:33:59 INFO - 'ts_paint', 15:33:59 INFO - 'tpaint', 15:33:59 INFO - 'sessionrestore', 15:33:59 INFO - 'sessionrestore_no_auto_restore', 15:33:59 INFO - 'tabpaint']}, 15:33:59 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['tsvgx', 15:33:59 INFO - 'tsvgr_opacity', 15:33:59 INFO - 'tart', 15:33:59 INFO - 'tscrollx', 15:33:59 INFO - 'cart']}, 15:33:59 INFO - 'svgr-e10s': {'tests': ['tsvgx', 15:33:59 INFO - 'tsvgr_opacity', 15:33:59 INFO - 'tart', 15:33:59 INFO - 'tscrollx', 15:33:59 INFO - 'cart']}, 15:33:59 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:59 INFO - 'talos_options': ['--disable-e10s'], 15:33:59 INFO - 'tests': ['tp5o']}, 15:33:59 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:59 INFO - 'tests': ['tp5o']}, 15:33:59 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:59 INFO - 'talos_options': ['--disable-e10s', 15:33:59 INFO - '--xperf_path', 15:33:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:33:59 INFO - 'tests': ['tp5n']}, 15:33:59 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:59 INFO - 'talos_options': ['--xperf_path', 15:33:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:33:59 INFO - 'tests': ['tp5n']}}, 15:33:59 INFO - 'talos.zip': {'path': '', 15:33:59 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:33:59 INFO - Running post-action listener: _resource_record_post_action 15:33:59 INFO - [mozharness: 2016-08-15 22:33:59.605481Z] Finished populate-webroot step (success) 15:33:59 INFO - [mozharness: 2016-08-15 22:33:59.605611Z] Running create-virtualenv step. 15:33:59 INFO - Running pre-action listener: _resource_record_pre_action 15:33:59 INFO - Running main action method: create_virtualenv 15:33:59 INFO - Creating virtualenv /builds/slave/test/build/venv 15:33:59 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 15:33:59 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:33:59 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:33:59 INFO - Using real prefix '/tools/python27' 15:33:59 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:34:00 INFO - Installing distribute.............................................................................................................................................................................................done. 15:34:03 INFO - Installing pip.................done. 15:34:03 INFO - Return code: 0 15:34:03 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:34:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:03 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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 15:34:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 15:34:03 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:03 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:03 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:03 INFO - 'HOME': '/Users/cltbld', 15:34:03 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:03 INFO - 'LOGNAME': 'cltbld', 15:34:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:03 INFO - 'MOZ_NO_REMOTE': '1', 15:34:03 INFO - 'NO_EM_RESTART': '1', 15:34:03 INFO - 'PAGER': '/bin/cat', 15:34:03 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:03 INFO - 'PWD': '/builds/slave/test', 15:34:03 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:03 INFO - 'SHELL': '/bin/bash', 15:34:03 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:03 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:03 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:03 INFO - 'USER': 'cltbld', 15:34:03 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:03 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:03 INFO - 'XPC_FLAGS': '0x0', 15:34:03 INFO - 'XPC_SERVICE_NAME': '0', 15:34:03 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:03 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 15:34:03 INFO - Cleaning up... 15:34:03 INFO - Return code: 0 15:34:03 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 15:34:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:03 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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 15:34:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 15:34:03 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:03 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:03 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:03 INFO - 'HOME': '/Users/cltbld', 15:34:03 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:03 INFO - 'LOGNAME': 'cltbld', 15:34:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:03 INFO - 'MOZ_NO_REMOTE': '1', 15:34:03 INFO - 'NO_EM_RESTART': '1', 15:34:03 INFO - 'PAGER': '/bin/cat', 15:34:03 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:03 INFO - 'PWD': '/builds/slave/test', 15:34:03 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:03 INFO - 'SHELL': '/bin/bash', 15:34:03 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:03 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:03 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:03 INFO - 'USER': 'cltbld', 15:34:03 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:03 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:03 INFO - 'XPC_FLAGS': '0x0', 15:34:03 INFO - 'XPC_SERVICE_NAME': '0', 15:34:03 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:03 INFO - Downloading/unpacking psutil>=3.1.1 15:34:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:34:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:34:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:34:06 INFO - Installing collected packages: psutil 15:34:06 INFO - Running setup.py install for psutil 15:34:06 INFO - building 'psutil._psutil_osx' extension 15:34:06 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 15:34:06 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 15:34:06 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 15:34:06 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 15:34:06 INFO - building 'psutil._psutil_posix' extension 15:34:06 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 15:34:07 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 15:34:07 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 15:34:07 INFO - ^ 15:34:07 INFO - 1 warning generated. 15:34:07 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 15:34:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:34:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:34:07 INFO - Successfully installed psutil 15:34:07 INFO - Cleaning up... 15:34:07 INFO - Return code: 0 15:34:07 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 15:34:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:07 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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 15:34:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 15:34:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:07 INFO - 'HOME': '/Users/cltbld', 15:34:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:07 INFO - 'LOGNAME': 'cltbld', 15:34:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:07 INFO - 'MOZ_NO_REMOTE': '1', 15:34:07 INFO - 'NO_EM_RESTART': '1', 15:34:07 INFO - 'PAGER': '/bin/cat', 15:34:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:07 INFO - 'PWD': '/builds/slave/test', 15:34:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:07 INFO - 'SHELL': '/bin/bash', 15:34:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:07 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:07 INFO - 'USER': 'cltbld', 15:34:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:07 INFO - 'XPC_FLAGS': '0x0', 15:34:07 INFO - 'XPC_SERVICE_NAME': '0', 15:34:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:07 INFO - Downloading/unpacking mozsystemmonitor==0.3 15:34:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:09 INFO - Downloading mozsystemmonitor-0.3.tar.gz 15:34:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:34:10 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 15:34:10 INFO - Installing collected packages: mozsystemmonitor 15:34:10 INFO - Running setup.py install for mozsystemmonitor 15:34:10 INFO - Successfully installed mozsystemmonitor 15:34:10 INFO - Cleaning up... 15:34:10 INFO - Return code: 0 15:34:10 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 15:34: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')]} 15:34:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34: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')]} 15:34:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:10 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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 15:34:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 15:34:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:10 INFO - 'HOME': '/Users/cltbld', 15:34:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:10 INFO - 'LOGNAME': 'cltbld', 15:34:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:10 INFO - 'MOZ_NO_REMOTE': '1', 15:34:10 INFO - 'NO_EM_RESTART': '1', 15:34:10 INFO - 'PAGER': '/bin/cat', 15:34:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:10 INFO - 'PWD': '/builds/slave/test', 15:34:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:10 INFO - 'SHELL': '/bin/bash', 15:34:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:10 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:10 INFO - 'USER': 'cltbld', 15:34:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:10 INFO - 'XPC_FLAGS': '0x0', 15:34:10 INFO - 'XPC_SERVICE_NAME': '0', 15:34:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:10 INFO - Downloading/unpacking jsonschema==2.5.1 15:34:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:13 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:34:13 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 15:34:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:13 INFO - Downloading functools32-3.2.3-2.tar.gz 15:34:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:34:13 INFO - warning: no files found matching '*.txt' 15:34:13 INFO - no previously-included directories found matching 'build' 15:34:13 INFO - no previously-included directories found matching 'dist' 15:34:13 INFO - no previously-included directories found matching '.git*' 15:34:13 INFO - Installing collected packages: jsonschema, functools32 15:34:13 INFO - Running setup.py install for functools32 15:34:13 INFO - warning: no files found matching '*.txt' 15:34:13 INFO - no previously-included directories found matching 'build' 15:34:13 INFO - no previously-included directories found matching 'dist' 15:34:13 INFO - no previously-included directories found matching '.git*' 15:34:13 INFO - Successfully installed jsonschema functools32 15:34:13 INFO - Cleaning up... 15:34:13 INFO - Return code: 0 15:34:13 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 15:34:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:13 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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 15:34:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 15:34:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:13 INFO - 'HOME': '/Users/cltbld', 15:34:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:13 INFO - 'LOGNAME': 'cltbld', 15:34:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:13 INFO - 'MOZ_NO_REMOTE': '1', 15:34:13 INFO - 'NO_EM_RESTART': '1', 15:34:13 INFO - 'PAGER': '/bin/cat', 15:34:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:13 INFO - 'PWD': '/builds/slave/test', 15:34:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:13 INFO - 'SHELL': '/bin/bash', 15:34:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:13 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:13 INFO - 'USER': 'cltbld', 15:34:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:13 INFO - 'XPC_FLAGS': '0x0', 15:34:13 INFO - 'XPC_SERVICE_NAME': '0', 15:34:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:14 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 15:34:14 INFO - Cleaning up... 15:34:14 INFO - Return code: 0 15:34:14 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:34:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 15:34:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 15:34:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:14 INFO - 'HOME': '/Users/cltbld', 15:34:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:14 INFO - 'LOGNAME': 'cltbld', 15:34:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:14 INFO - 'MOZ_NO_REMOTE': '1', 15:34:14 INFO - 'NO_EM_RESTART': '1', 15:34:14 INFO - 'PAGER': '/bin/cat', 15:34:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:14 INFO - 'PWD': '/builds/slave/test', 15:34:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:14 INFO - 'SHELL': '/bin/bash', 15:34:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:14 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:14 INFO - 'USER': 'cltbld', 15:34:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:14 INFO - 'XPC_FLAGS': '0x0', 15:34:14 INFO - 'XPC_SERVICE_NAME': '0', 15:34:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:14 INFO - Downloading/unpacking blobuploader==1.2.4 15:34:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:16 INFO - Downloading blobuploader-1.2.4.tar.gz 15:34:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:34:16 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:34:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:34:17 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:34:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:34:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:34:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:34:17 INFO - Downloading docopt-0.6.1.tar.gz 15:34:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:34:18 INFO - Installing collected packages: blobuploader, requests, docopt 15:34:18 INFO - Running setup.py install for blobuploader 15:34:18 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:34:18 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:34:18 INFO - Running setup.py install for requests 15:34:18 INFO - Running setup.py install for docopt 15:34:18 INFO - Successfully installed blobuploader requests docopt 15:34:18 INFO - Cleaning up... 15:34:18 INFO - Return code: 0 15:34:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:34: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')]} 15:34:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34: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')]} 15:34:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:18 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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 15:34:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 15:34:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:18 INFO - 'HOME': '/Users/cltbld', 15:34:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:18 INFO - 'LOGNAME': 'cltbld', 15:34:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:18 INFO - 'MOZ_NO_REMOTE': '1', 15:34:18 INFO - 'NO_EM_RESTART': '1', 15:34:18 INFO - 'PAGER': '/bin/cat', 15:34:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:18 INFO - 'PWD': '/builds/slave/test', 15:34:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:18 INFO - 'SHELL': '/bin/bash', 15:34:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:18 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:18 INFO - 'USER': 'cltbld', 15:34:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:18 INFO - 'XPC_FLAGS': '0x0', 15:34:18 INFO - 'XPC_SERVICE_NAME': '0', 15:34:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:34:19 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-F1ini8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:34:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:34:19 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-hmM4PN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:34:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:34:19 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-hYUmYC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:34:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:34:19 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-7uzGAp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:34:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:34:19 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-4wtS0q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:34:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:34:19 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-qf1HEW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:34:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:34:19 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-6CHqlF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:34:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:34:19 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-GDu03y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-FSOwXx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-HEen2K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-JHbA75-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-_vTuzg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-04hK8Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-pa2fCt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-xacTNC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-zinPPP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:34:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:34:20 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-6DMUo0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:34:20 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:34:20 INFO - Running setup.py install for manifestparser 15:34:21 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:34:21 INFO - Running setup.py install for mozcrash 15:34:21 INFO - Running setup.py install for mozdebug 15:34:21 INFO - Running setup.py install for mozdevice 15:34:21 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:34:21 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:34:21 INFO - Running setup.py install for mozfile 15:34:21 INFO - Running setup.py install for mozhttpd 15:34:21 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:34:21 INFO - Running setup.py install for mozinfo 15:34:21 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:34:21 INFO - Running setup.py install for mozInstall 15:34:22 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Running setup.py install for mozleak 15:34:22 INFO - Running setup.py install for mozlog 15:34:22 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Running setup.py install for moznetwork 15:34:22 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Running setup.py install for mozprocess 15:34:22 INFO - Running setup.py install for mozprofile 15:34:22 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:34:22 INFO - Running setup.py install for mozrunner 15:34:23 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:34:23 INFO - Running setup.py install for mozscreenshot 15:34:23 INFO - Running setup.py install for moztest 15:34:23 INFO - Running setup.py install for mozversion 15:34:23 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:34:23 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:34:23 INFO - Cleaning up... 15:34:23 INFO - Return code: 0 15:34:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:34:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:23 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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 15:34:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 15:34:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:23 INFO - 'HOME': '/Users/cltbld', 15:34:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:23 INFO - 'LOGNAME': 'cltbld', 15:34:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:23 INFO - 'MOZ_NO_REMOTE': '1', 15:34:23 INFO - 'NO_EM_RESTART': '1', 15:34:23 INFO - 'PAGER': '/bin/cat', 15:34:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:23 INFO - 'PWD': '/builds/slave/test', 15:34:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:23 INFO - 'SHELL': '/bin/bash', 15:34:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:23 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:23 INFO - 'USER': 'cltbld', 15:34:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:23 INFO - 'XPC_FLAGS': '0x0', 15:34:23 INFO - 'XPC_SERVICE_NAME': '0', 15:34:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:34:23 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-W9ZCW7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:34:23 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 15:34:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:34:23 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-MFgwNE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-0uMUos-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-Uqyvbl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-Y17xSs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-A87xO2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-RKpgBR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-XVOW_Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-VrnNm8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-FTmBaA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-gMvPqj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:34:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 15:34:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:34:24 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-m5s1Yt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 15:34:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:34:25 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-6XO4DX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 15:34:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:34:25 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-VNv6OU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 15:34:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:34:25 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-WVh1H2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 15:34:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:34:25 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-M7wzdR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 15:34:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:34:25 INFO - Running setup.py (path:/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/pip-5ERopS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:34:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:34:25 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:34: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 15:34: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 15:34: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 15:34: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 15:34: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 15:34: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 15:34:28 INFO - Downloading blessings-1.6.tar.gz 15:34:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:34:28 INFO - Installing collected packages: blessings 15:34:28 INFO - Running setup.py install for blessings 15:34:28 INFO - Successfully installed blessings 15:34:28 INFO - Cleaning up... 15:34:28 INFO - Return code: 0 15:34:28 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:34:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:34:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:34:28 INFO - Reading from file tmpfile_stdout 15:34:28 INFO - Current package versions: 15:34:28 INFO - blessings == 1.6 15:34:28 INFO - blobuploader == 1.2.4 15:34:28 INFO - docopt == 0.6.1 15:34:28 INFO - functools32 == 3.2.3-2 15:34:28 INFO - jsonschema == 2.5.1 15:34:28 INFO - manifestparser == 1.1 15:34:28 INFO - mozInstall == 1.12 15:34:28 INFO - mozcrash == 0.17 15:34:28 INFO - mozdebug == 0.1 15:34:28 INFO - mozdevice == 0.48 15:34:28 INFO - mozfile == 1.2 15:34:28 INFO - mozhttpd == 0.7 15:34:28 INFO - mozinfo == 0.9 15:34:28 INFO - mozleak == 0.1 15:34:28 INFO - mozlog == 3.3 15:34:28 INFO - moznetwork == 0.27 15:34:28 INFO - mozprocess == 0.23 15:34:28 INFO - mozprofile == 0.28 15:34:28 INFO - mozrunner == 6.12 15:34:28 INFO - mozscreenshot == 0.1 15:34:28 INFO - mozsystemmonitor == 0.3 15:34:28 INFO - moztest == 0.7 15:34:28 INFO - mozversion == 1.4 15:34:28 INFO - psutil == 3.1.1 15:34:28 INFO - requests == 1.2.3 15:34:28 INFO - wsgiref == 0.1.2 15:34:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:34: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')]} 15:34:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34: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')]} 15:34:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:28 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 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 15:34:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 15:34:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:28 INFO - 'HOME': '/Users/cltbld', 15:34:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:28 INFO - 'LOGNAME': 'cltbld', 15:34:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:28 INFO - 'MOZ_NO_REMOTE': '1', 15:34:28 INFO - 'NO_EM_RESTART': '1', 15:34:28 INFO - 'PAGER': '/bin/cat', 15:34:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:28 INFO - 'PWD': '/builds/slave/test', 15:34:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:28 INFO - 'SHELL': '/bin/bash', 15:34:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:28 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:28 INFO - 'USER': 'cltbld', 15:34:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:28 INFO - 'XPC_FLAGS': '0x0', 15:34:28 INFO - 'XPC_SERVICE_NAME': '0', 15:34:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 15:34:29 INFO - Cleaning up... 15:34:29 INFO - Return code: 0 15:34:29 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:34:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:34:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:34:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:34:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:34:29 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10c2dfa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c374618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb3484b41a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, '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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 15:34:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 15:34:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 15:34:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:34:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:34:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:34:29 INFO - 'HOME': '/Users/cltbld', 15:34:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:34:29 INFO - 'LOGNAME': 'cltbld', 15:34:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:34:29 INFO - 'MOZ_NO_REMOTE': '1', 15:34:29 INFO - 'NO_EM_RESTART': '1', 15:34:29 INFO - 'PAGER': '/bin/cat', 15:34:29 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:34:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:34:29 INFO - 'PWD': '/builds/slave/test', 15:34:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:34:29 INFO - 'SHELL': '/bin/bash', 15:34:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:34:29 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:34:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:34:29 INFO - 'USER': 'cltbld', 15:34:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:34:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:34:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:34:29 INFO - 'XPC_FLAGS': '0x0', 15:34:29 INFO - 'XPC_SERVICE_NAME': '0', 15:34:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:34:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:34:29 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 15:34:29 INFO - Cleaning up... 15:34:29 INFO - Return code: 0 15:34:29 INFO - Running post-action listener: _resource_record_post_action 15:34:29 INFO - Running post-action listener: _start_resource_monitoring 15:34:29 INFO - Starting resource monitoring. 15:34:29 INFO - [mozharness: 2016-08-15 22:34:29.312623Z] Finished create-virtualenv step (success) 15:34:29 INFO - [mozharness: 2016-08-15 22:34:29.313612Z] Running install step. 15:34:29 INFO - Running pre-action listener: _resource_record_pre_action 15:34:29 INFO - Running main action method: install 15:34:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:34:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:34:29 INFO - Reading from file tmpfile_stdout 15:34:29 INFO - Detecting whether we're running mozinstall >=1.0... 15:34:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:34:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:34:29 INFO - Reading from file tmpfile_stdout 15:34:29 INFO - Output received: 15:34:29 INFO - Usage: mozinstall [options] installer 15:34:29 INFO - Options: 15:34:29 INFO - -h, --help show this help message and exit 15:34:29 INFO - -d DEST, --destination=DEST 15:34:29 INFO - Directory to install application into. [default: 15:34:29 INFO - "/builds/slave/test"] 15:34:29 INFO - --app=APP Application being installed. [default: firefox] 15:34:29 INFO - mkdir: /builds/slave/test/build/application 15:34:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 15:34:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 15:35:04 INFO - Reading from file tmpfile_stdout 15:35:04 INFO - Output received: 15:35:04 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 15:35:04 INFO - Running post-action listener: _resource_record_post_action 15:35:04 INFO - [mozharness: 2016-08-15 22:35:04.100466Z] Finished install step (success) 15:35:04 INFO - [mozharness: 2016-08-15 22:35:04.100616Z] Running run-tests step. 15:35:04 INFO - Running pre-action listener: _resource_record_pre_action 15:35:04 INFO - Running main action method: run_tests 15:35:04 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 15:35:04 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 15:35:04 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 15:35:04 INFO - 2016-08-15 15:35:04.115 screenresolution[2203:18998] starting screenresolution argv=screenresolution get 15:35:04 INFO - 2016-08-15 15:35:04.118 screenresolution[2203:18998] Display 0: 1600x1200x32@60 15:35:04 INFO - 2016-08-15 15:35:04.123 screenresolution[2204:19000] starting screenresolution argv=screenresolution list 15:35:04 INFO - Available Modes on Display 0 15:35:04 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 15:35:04 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 15:35:04 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 15:35:04 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 15:35:04 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 15:35:04 INFO - Intel Iris: 15:35:04 INFO - Chipset Model: Intel Iris 15:35:04 INFO - Type: GPU 15:35:04 INFO - Bus: Built-In 15:35:04 INFO - VRAM (Dynamic, Max): 1536 MB 15:35:04 INFO - Vendor: Intel (0x8086) 15:35:04 INFO - Device ID: 0x0a2e 15:35:04 INFO - Revision ID: 0x0009 15:35:04 INFO - Displays: 15:35:04 INFO - Display: 15:35:04 INFO - Resolution: 1600 x 1200 @ 60 Hz 15:35:04 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 15:35:04 INFO - Display Serial Number: 1600x1200 60 15:35:04 INFO - Main Display: Yes 15:35:04 INFO - Mirror: Off 15:35:04 INFO - Online: Yes 15:35:04 INFO - Rotation: Supported 15:35:04 INFO - Return code: 0 15:35:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:35:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:35:04 INFO - Python 2.7.3 15:35:04 INFO - Return code: 0 15:35:04 INFO - grabbing minidump binary from tooltool 15:35:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:35:04 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 0x10c243d30>, '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 0x10bfa8db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c23bb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:35:04 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 15:35:04 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 15:35:04 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 15:35:04 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:35:04 INFO - Return code: 0 15:35:04 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 15:35:04 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:35:04 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:35:04 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 15:35:04 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:35:04 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/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0183', '--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 15:35:04 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/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0183 --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 15:35:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.DmMh6QMDzf/Render', 15:35:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:35:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:35:04 INFO - 'HOME': '/Users/cltbld', 15:35:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:35:04 INFO - 'LOGNAME': 'cltbld', 15:35:04 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:35:04 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 15:35:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:35:04 INFO - 'MOZ_NO_REMOTE': '1', 15:35:04 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:35:04 INFO - 'NO_EM_RESTART': '1', 15:35:04 INFO - 'PAGER': '/bin/cat', 15:35:04 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:35:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:35:04 INFO - 'PWD': '/builds/slave/test', 15:35:04 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:35:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:35:04 INFO - 'SHELL': '/bin/bash', 15:35:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.iQuEQwvW7F/Listeners', 15:35:04 INFO - 'TMPDIR': '/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/', 15:35:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:35:04 INFO - 'USER': 'cltbld', 15:35:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:35:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:35:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:35:04 INFO - 'XPC_FLAGS': '0x0', 15:35:04 INFO - 'XPC_SERVICE_NAME': '0', 15:35:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 15:35:04 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/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0183', '--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 15:35:04 INFO - mozversion application_buildid: 20160815124617 15:35:04 INFO - mozversion application_changeset: 90418dcd93dbcbe0166653878e04126df0712eba 15:35:04 INFO - mozversion application_display_name: Nightly 15:35:04 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:35:04 INFO - mozversion application_name: Firefox 15:35:04 INFO - mozversion application_remotingname: firefox 15:35:04 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 15:35:04 INFO - mozversion application_vendor: Mozilla 15:35:04 INFO - mozversion application_version: 51.0a1 15:35:04 INFO - mozversion platform_buildid: 20160815124617 15:35:04 INFO - mozversion platform_changeset: 90418dcd93dbcbe0166653878e04126df0712eba 15:35:04 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 15:35:04 INFO - mozversion platform_version: 51.0a1 15:35:04 INFO - using testdate: 1471300504 15:35:04 INFO - actual date: 1471300504 15:35:04 INFO - starting webserver on 'localhost:52517' 15:35:04 INFO - SUITE-START | Running 2 tests 15:35:04 INFO - TEST-START | dromaeo_css 15:35:04 INFO - operating with platform_type : mac_ 15:35:04 INFO - Initialising browser for dromaeo_css test... 15:35:04 INFO - TEST-INFO | started process 2214 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/tmpQYEREV/profile http://localhost:52517/getInfo.html) 15:35:07 INFO - PROCESS | 2214 | __metrics Screen width/height:1600/1200 15:35:07 INFO - PROCESS | 2214 | colorDepth:24 15:35:07 INFO - PROCESS | 2214 | Browser inner width/height: 1024/689 15:35:07 INFO - PROCESS | 2214 | __metrics 15:35:07 ERROR - PROCESS | 2214 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 15:35:08 INFO - TEST-INFO | 2214: exit 0 15:35:08 INFO - Browser initialized. 15:35:08 INFO - Running cycle 1/1 for dromaeo_css test... 15:35:08 INFO - TEST-INFO | started process 2217 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/tmpQYEREV/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:35:20 INFO - PROCESS | 2217 | RSS: Main: 239337472 15:35:20 INFO - PROCESS | 2217 | 15:36:10 INFO - PROCESS | 2217 | 1471300570110 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 15:38:21 INFO - PROCESS | 2217 | Cycle 1(1): loaded http://localhost:52517/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52517/tests/dromaeo/cssquery-ext.html) 15:38:23 INFO - PROCESS | 2217 | RSS: Main: 256593920 15:38:23 INFO - PROCESS | 2217 | 15:41:25 INFO - PROCESS | 2217 | Cycle 1(1): loaded http://localhost:52517/tests/dromaeo/cssquery-ext.html (next: http://localhost:52517/tests/dromaeo/cssquery-jquery.html) 15:41:26 INFO - PROCESS | 2217 | RSS: Main: 266633216 15:41:26 INFO - PROCESS | 2217 | 15:44:27 INFO - PROCESS | 2217 | Cycle 1(1): loaded http://localhost:52517/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52517/tests/dromaeo/cssquery-mootools.html) 15:44:28 INFO - PROCESS | 2217 | RSS: Main: 271360000 15:44:28 INFO - PROCESS | 2217 | 15:47:30 INFO - PROCESS | 2217 | Cycle 1(1): loaded http://localhost:52517/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52517/tests/dromaeo/cssquery-prototype.html) 15:47:31 INFO - PROCESS | 2217 | RSS: Main: 270848000 15:47:31 INFO - PROCESS | 2217 | 15:50:33 INFO - PROCESS | 2217 | Cycle 1(1): loaded http://localhost:52517/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52517/tests/dromaeo/cssquery-yui.html) 15:50:34 INFO - PROCESS | 2217 | RSS: Main: 276267008 15:50:34 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | Cycle 1(1): loaded http://localhost:52517/tests/dromaeo/cssquery-yui.html (next: http://localhost:52517/tests/dromaeo/cssquery-dojo.html) 15:53:37 INFO - PROCESS | 2217 | RSS: Main: 278810624 15:53:37 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | __start_tp_report 15:53:37 INFO - PROCESS | 2217 | _x_x_mozilla_page_load 15:53:37 INFO - PROCESS | 2217 | _x_x_mozilla_page_load_details 15:53:37 INFO - PROCESS | 2217 | |i|pagename|runs| 15:53:37 INFO - PROCESS | 2217 | |0;dojo.html;2773.403718200587;3279.4097062528767;3293.1108600677817;3311.039798458447;3313.933721325572;5505.614606977513;5531.308586426697;5560.805371811987;5596.27248457701;5603.971980140093;5394.406615272317;5570.442955704438;5611.130274807401;5617.9719101404435;5642.4357564243655;5081.136206844845;5086.033653605812;5117.692938423688;5165.096108181053;5182.896342073175;5087.465816089313;5257.789688412459;5279.076161671711;5300.973495132519;5314.681119132864;5070.062038522885;5178.8705282368055;5193.922091168635;5201.843944681666;5206.193040078794;5104.438511763703;5124.5131712487255;5171.456997015297;5172.844814655567;5177.068127737006;4177.394277829698;4443.333499974998;4555.703879247838;5036.924446133311;5099.286099946011;5357.973210133963;5418.45815418455;5463.562914966833;5569.164625306196;5584.6090773645865;5473.945260547383;5837.357890632027;6106.938930610726;6123.142760013601;6175.938240617626;6139.2325959255095;6142.293636231846;6183.752649893999;6206.038064100072;6214.440700336946;5494.725263736797;5618.185363122325;5726.3700992890335;5745.109508026263;5758.42415758425;6225.968870155621;6305.590136641195;6311.873762524816;6314.71583778731;6323.146375239376;6070.939290607126;6075.75696972125;6097.695115244309;6102.72537735803;6111.480524155497;5991.161237426763;6121.632702037892;6133.233345831771;6181.979973304445;6196.10156527301;5927.555433342516;6032.487238584682;6058.363871793486;6077.969610151921;6130.601510901777;6127.18952814863;6132.819519597536;6134.754609815646;6145.877082458326;6151.569390142737;4841.2496063110275;4876.634252431082;4900.828471003498;4905.828296009622;4966.205407134913;4314.029343397773;4359.738415695068;4384.430024096847;4426.557344265612;4437.156940181355;5555.2500412444615;5558.166275058693;5605.5895964735555;5729.111987641839;5731.627444216113;6146.631202127886;6192.225971753531;6215.533834962396;6234;6239.656818874914;5660.518855897295;5677.489025987681;5680.715964201773;5688.829335119953;5705.5720820938595;3995.4805875236034;5201.531862132426;5304.257403963448;5361.973190134102;5396.811111611075;6254.530910181755;6257.74969001244;6263.749450022039;6293.402126797947;6310.211223597051;6128.383357565242;6218.53360997936;6232.034034724625;6252.999520076948;6254.781082662085;6180.567360284737;6225;6240.7503699851495;6252.718627661675;6275.780347687809;6081;6118.235220597426;6140.385961403824;6151.692415379123;6153.938460615515;6217.813465596039;6234.096056071753;6242.063690446469;6245.531585131042;6254.655993920196;5765.56758243125;5801.94198058014;5938.317093534299;5966.254218222723;5995.850103747442;5025.824096156617;6014.248218972629;6030.879382412415;6042.3655516170165;6046.455818976313;5633.1831884375715;5780.7398667060925;5806.65160090396;5874.618149820248;5879.059350503899;5736;5816.796412125555;5843.766249350148;5858.121281807763;5980.9401905980385;5775.94224057754;5777.162311464898;5780.161876527964;5781;5794.768209271582 15:53:37 INFO - PROCESS | 2217 | |1;ext.html;492.608376340809;515.9355080614923;518.0467938992253;538.9487998640128;559.2673597587161;31556.84221578889;39371.0157246069;41422.37866432006;41464;41528.37707434391;31539.84230078852;33720.49419258713;34911.82544087276;42061;42107.157856842845;9657.517124143782;9864.506774661275;9870.506474676273;9874.753131171743;9891.55488003038;8504.064552899175;9165.175134237918;9448.716538503855;9685.564149613248;9694.951525242364;9659.082387173208;9743.366681165737;9782.706518804447;9805.264605154607;9827.508624568778;9773.951130244339;9779.902200978006;9816.705498835046;9822.214222862154;9845.310828242025;9673.467959262238;9797.216222702167;9846.458444785534;9874.01259874014;9922.9503852481;41106.56127035569;41152.588474115175;41469;41526.58473415257;41547.7922610385;3315.552400425936;3379.1889946412684;3392.8982130536124;3483.0421634050585;3859.2281543691092;31912.521312180335;32695.83652081748;32905.17737056569;33053.504197437054;33198.502022469685;3246.2695893424025;3390.2202493426403;3458.360203362361;3462.8441720122655;3475.94786078209;494618;500184;500674;502070.48964755307;503055;46347.768261158475;49048.75475622599;60807.695961520796;60979;61253.69373153106;63554.36445635577;64151.679241604426;64504;64594.24869015748;64599.67700161563;16069.116198609188;16299.918500407422;16331.775116866282;16358.672826543641;16396.918015410087;12698.492060317669;12718.300493472763;12744.553940612033;12748.426320815586;12754.553590624284;14007.509737159355;16716.41492547755;17219;17238.224279907434;17398.0431076292;6235.781747638811;7230.132384113835;7246.420286377077;7261.709531618676;7266.818329541804;851.7104184577273;921.3964853021282;957.6313119449062;1052.5421441672897;1057.9259451838452;24500.632490512657;30469;31139.5088392928;31405.52891706626;31492.842535787175;1021.5760459409262;1049.2917280835406;1060.3213943076437;1089.629525961177;1123.2025262063862;15428.691426171414;16042.957207781457;16070.919645401931;16142.919285403732;16491;664130;664774;666610;667190;674027;60447.69776151091;60515.39484605098;60536.78926421447;60576.39423605796;60908.69545652244;1320.4058173821818;1378.4830688491816;1383.9169649821042;1401.7196560687698;1407.4370251899118;26079.739202607732;27970.021049263993;30173.547396789505;30234;31987.360252794348;51033;51317.48682513127;51862.740686296325;51864.481355187476;52068.73965630148;503706;508035;511408;512754;514836.3872709637;26408.735912640626;26727.465450690488;26892.327691807863;26905.730942690323;26935.057272995353;41687.791561042;47674.04651906873;47822.76088619535;48111.5188848121;49044.01911961812;39779.220974007425;40145.39781903332;40436.191276173726;40802.27972368756;41023.66692329978;38948.41577376285;39228.803855980535;40389;40460;40546.797266013484;37245.882623521335;37303;37703.434448482745;38088.04779880525;38208.617913820504;34036.82981585076;34736.30527389488;35208.11979700528;35695.82152089327;35900.461493077106;25815.34221405646;25936.481270374865;25948.74051259463;26056.478870422863;26529.204123876316 15:53:37 INFO - PROCESS | 2217 | |2;jquery.html;359.82728290420596;371.2611902314395;380.6840322532299;382.298482285007;399.9381641741176;20021;21468.4632884178;22078.77921220787;22146.114155433785;22399.776002239993;20497.872617006058;20824.791752082514;21066.262680806176;21207.363779086612;21342.826144562045;5869.148973398855;5958.255218097738;6121.326654068072;6189.473894718932;6203.503719702436;4190.7485550866895;6078.787242446515;6172.105044768506;6173.166622505949;6508.381703738138;6771.695273712695;6892.931070689304;6909.032735417046;6913.516053876231;6919.827004324882;6046.909296360558;6671.733130674767;6696.799096027103;6774.45804335652;6824.829379265509;5326.307580014612;5559.221708960748;5828.0966450200285;5939;5951.880962380728;21770;22460;22485.43786405353;27063.72936270632;27480.312992175157;2324.941876453085;2343.3204370732637;2688.7445692659167;2924.8830046798103;3010.247438140465;15899;16149.273282702306;16241;16393.262303196265;16579.834201657948;1794.9192286347015;1902.1155162849202;1918.6258679557493;1919.7408349872728;1926.7591551056119;97023.51488242584;109496;110285;114919;115692;11087.113030957504;11100.500477478532;11118.833217501582;11330.09359251258;11466.656000320003;13703.314834258446;13752.449902003807;13933.58199254024;13951.372188251553;14008.719825603635;6958.686859091353;8721.738347849448;8723.302135829246;8769.956150219208;8845.115488451233;7643.235676432312;8613.827723445496;8663.48019118855;8701.129887011375;8879.556022198993;5646.265985421869;5677.205191273225;6766.560173588799;6784.864302713918;6801.591904485746;1293.734784369202;1650.5460998225585;1852.2961274715792;1914.1482040492126;1920.9231630734894;754.1176823116966;906.8730377747121;909.6543313540813;981.9116279534876;993.9950300248453;21322.573548528944;21780.45548861291;21891.343259702233;22088.337349879206;22123.889380552995;926.7766548156369;949.4967667136428;961.3847137831793;968.4625033106694;1002.644061358222;9432.811343773086;10748.677539673823;11633.986274735204;11721.531138754355;11810.704732381588;606952;627005;633741;634529;640065.799671008;118139.81860181288;128755.35622321829;131373;131881;148880;964.4165280005636;968.5447839515416;998.5057396588589;1029.1715169288793;1035.0839507036328;18337.816621834143;20061.799382005993;20744;20860.895695521423;20904.1638334471;56796.716016419654;58291.708541457025;58292.4170758287;58352.416475834696;58534.414655852896;77564;80531.98670033296;84891.5755421219;85709;87044;5606.074997625509;7935.008123984502;7971.123176450702;8090.0291964962225;8176.591170441335;10279.43069909889;12499.625011249676;12676.683082923;12784.61646150617;12952.935235323763;9420.623175073195;10724.249302549058;10747.46262686847;11231.494582743959;11333.546658133582;9217.585208665492;10762.408067556047;11010.174236932422;11051.447427628425;11229.101671866394;11067.557297708323;11094.223404361617;11282.323060616389;11584.362860042778;11642.592509262135;7414.332710055905;7841.902133701173;7984.401169912164;8077.111517733162;8269.131741167092;10763.331683589056;11104.333739975627;11132.220744548127;11159.218854680095;11309.886901131213 15:53:37 INFO - PROCESS | 2217 | |3;mootools.html;1531.2573401900077;1550.5580909440807;1766.3641089207883;1775.5117342730755;1854.1934258597512;7222.602756848384;8031.839363212733;8481.533515656636;9049.321300902426;9064.501452420114;8688.131186881308;8886.377953543255;8895.822083558325;8908.955455222715;8933.508657023878;1819.4996375996575;1969.970450443241;2167.035669127239;2270.318904328703;2391.390195500145;2011.3965810256936;2031.3601215617107;2305.0318866076286;2392.940176495593;2393.628987506939;1964.6168997045581;2368.5144545368157;2369.727481339642;2372.3001714494267;2393.628987506939;2342.227065068523;2345.2260753951327;2356.1988923765916;2366.503034362786;2368.2658375903525;2332.731735850365;2367.171489978511;2369.7393286738443;2376.6910301660846;2385.3678775124604;8949.328800339936;8972.013078561353;8989.865152022725;9008.324375671786;9008.819823603557;5251.159814429673;5286.07493688603;5399.028174928511;5401.892612014528;5418.29562156921;3537.3809583323073;3611;3721.79530125843;3727.254549090193;3752.0994961209385;1073.955607250165;1111.6831702964616;1113.8719047309582;1129.7571022230177;1131.2533727739735;9684.934657187703;11562.30626162433;11829.526818927232;11927.940360298144;11928.880711192951;4553.453585569687;4657.697249678828;4790.904181916412;4831.178699621073;4849.951500485021;10013.549390277454;10057.044580764816;10134;10144.644937427154;10150.492475376202;5345.70598617072;5372.382176049726;5376;5397.271368365299;5490.1764735289225;4428.689991700615;4749.738764367993;4877;4888.584470319992;4935.481774413706;3890.4747859039235;3932.488776459042;3978.244133614604;4009.3384591542654;4055.5538890721996;1302.8762267584564;1309.3453273363318;1314.4413624209672;1321.8810307072217;1323.7021670124145;776.3401109057256;874.5015341255423;888.9466632002101;904.5296445848122;922.6586163119689;5757.712114394263;5770.942290577124;5868.23712917318;5961.791337303173;6074.574779765462;432.8831215571778;434.611023134293;438.97146685465344;447.05447977527297;447.44740245796413;3594.137407022296;3978.76127432355;4039.5758445363404;4045.4943132108488;4100.8675488745685;9608;10043.648472303581;10892.891071089347;11035.337879727242;11063.446827658585;10279.845802312972;10874.45627718611;10922.399268040175;11013.559457621766;11095.944520277348;7959.442839001214;8225.012998440225;8290.170982901782;8298.377621678399;8318.960129983752;5967.31375891778;6040.909386359121;6043.425874541911;6117.357677443804;6201.131841542278;9432.575534101119;10167.983201679774;10300.742481438025;10334.5349459273;10337;8851.380403371702;10316;10358.430286334324;10359.482025898524;10361.481925903523;7010.369066784014;7595.5442673439775;7784.610769461618;7803.414743894345;8184.713535026245;8394.202550757669;8581.570921453778;8587.22714955657;8588.742337729878;8599.484030958163;7579.5073320236215;7605.6577454015805;7623.4663573549315;7762.92237077622;7795.571243581658;7467.290607392289;7491.838764991435;7533.133689625544;7533.171351151478;7737.381009519338;7024.192217895007;7152.964235178791;7156.892646610201;7158.570485770871;7178.892316615151;5003.099442100457;5028.572571331478;5088.771005304696;5135.281060651587;5160.354955630546;4399.296112621965;5039.47085556026;5156.2523434101095;5207.921881171861;5265.420803711512 15:53:37 INFO - PROCESS | 2217 | |4;prototype.html;271.7119852955867;301.4528630535579;312.2942150739329;313.23882964396523;318.039520647644;4449.421575195228;5408.2698835657175;5526.19870118833;5554.666719996803;5620.94835385084;5433.587267310498;5584.776608935648;5602.38373778884;5613.354464236614;5644.322681278242;3969.9554729314427;4252.808623611937;4254.659627229814;4261.893452663678;4263.573642635727;4108.691848111389;4135.73117747347;4293.849715259967;4302.2255993921235;4338.501072376685;3733.8693145739903;3855.363864962278;4014.8795536133816;4053.9662386091504;4160.230357383879;4229.873103806891;4267.423897773791;4270.636995855356;4278.2085314216965;4293;3701.1857391373856;3713.9442908356395;3739.2895349883433;3740.2706472237924;3750.8124593770476;4849.4908034656555;5412.646838290428;5428.728563571805;5442.9386269677425;5473.452654734495;3890.513685789276;3933.8819835404984;4349.412829268072;4553.612942899857;4918.803247870117;5463.983971780738;5646.064046695696;5872.970635146839;5897.439743224387;5955.434233747787;3771.3600479664346;3836.117692930614;3899.2396482685886;4060.796960151981;4089;5197.220416937452;5514.889702205974;5659.660420374791;5760.971195143998;6005.489533389624;4166.541680415152;4184.832606695759;4190.622843944059;4193.51774545925;4196.895077623023;3761.5110035695184;3974.205158968218;4168.95776055986;4214.599613036818;4220.53574106848;4415.933760993587;4870.780814863339;4903.387076615423;4934.654574179773;4947.084789313988;5886.970565147232;5910.143029260733;5930.673812940329;6004.42957918997;6023.186869772612;1246.8316777234957;1421.46694989379;1425.6364627020043;1441.5459130374109;1461.875740562064;752.9322360987537;797.8085259537669;812.3663542436909;861.6984055580497;876.8381893990488;3925.9018524536546;4585.72485650862;4652.232381657056;4671.743054131987;4689.648276379286;4578.748168850745;5047.570956468668;5059.671121377099;5063.569596584258;5072.920102757852;3981.303271927401;4065.8576949806616;4456.688031837805;4653.557911998355;4653.906921861544;2229.4314949687728;2334.124703236286;2555.6549865768256;2646.3781011462293;2654.840709557394;4463.642908567307;4838.395200599925;5025.547700706954;5240.292560504283;5252.264682944391;4742.762861856893;4933.9506604933495;5082.467684958992;5153.484651534816;5201.661891977009;5016.623753218596;5261.868453288622;6337.859185346681;6418.967905160538;6451.258105317855;5488.765027868698;6176.320604733565;6187.381261873777;6223.315435302204;6253;5048.823291184791;5320.201969704575;5835.970820146042;5888.438529239795;6161.661108639068;5565.66424058215;5641.802536911188;5863.882722345444;6342.39747224013;6417.839554011187;3427.1774774053547;4019.979900100481;4031.879043628696;4046;4065.2479291331197;5218.869528261824;5642.6614403135945;5845.386234445492;5950.899083669535;6146.0473626587955;4961.70229786214;5091.490850914879;5926.585139040226;5977.880442391215;6011.338752737282;5135.332406787244;5838.4453476919625;5910.940890591211;5923.466887980103;5975.25309336333;4747.454042785124;5741.196232527533;5820.679862607597;5835.533157347317;5899.793507227227;5925.851853703692;5932.851678708067;5939.792107276225;6009.579329446897;6024.277086749618;5140.588752899685;5405.78376864921;5768;5846.766129354948;5859.794907178399 15:53:37 INFO - PROCESS | 2217 | |5;yui.html;714.7605552140033;739.349372552154;765.1774342581723;800.3157300508062;856.3021137772716;15215.087094774308;15570.922145389257;16173.43392981246;16291.429799957004;16321.83678163218;14392.71214575708;14534.854651453483;14629.487967921124;14629.634259143526;14674.63313417165;689.3623398356525;842.8988521377444;847.5126802088809;862.9352798540103;868.8609822428413;861.4228466927143;869.395769939892;873.1443185678039;875.0549406640813;875.4440930009458;929.604917909889;930.3534043839534;931.3945935142144;933.0948979489918;933.1042199488465;921.230772305126;924.6671198368582;924.7364501117149;925.0656836595053;925.8472352061935;681.2404169351187;681.7784220128478;682.6450245872119;683.2859661653534;683.4259222253331;15383.461578844686;15614.375424982987;15782.210889455597;15782.684346313124;15815.209239537977;14890.404383824634;14947.925260373737;14956.700865982619;14965.625859353495;15066.623334416618;9832.852507212398;11974.86238807312;11998.220115692538;12142.150049496538;12509.937450312691;3063.6476805167244;3620.2216523447587;3864.14988702485;4055.3105971984537;4128.02991297045;120478.59042819095;123138.37631919666;125140;125740.37129814384;126160;9995.850062249072;11373.658790236306;11456.427178641035;11628.825567616492;11943.223690460092;20739.274125405842;24523.87738061334;24584.5083098337;24656.767161641845;24679.01283948622;8331.29184019353;8337.624806883705;8359.665613375397;8505.829883402297;8506.106858779738;4473.083017981306;4601.470830854428;4605.953940460619;4679.181143299909;4814.277858321209;3681.687056600219;3772.830222639933;3785.337565925952;3795.35478968576;3805.46723458716;653.5719103986801;659.0838734159522;662.7746566167526;672.122879642062;677.6781029011279;608.7352001879196;630.2909227119491;676.539952832069;694.9610332552764;696.4080531548245;9509.191718703849;9638.759031024281;9666.806663866684;9784.217262618973;9972.152367048737;528.5824198882916;606.0394275074057;679.7586856665911;684.1619016704498;690.1683471416931;4579.335996280587;4716.858494245178;4718.8584342469785;4724.362211101526;4725.810967561259;138427;159880.20059899858;168936;171701;173791;103312;136328.31835840957;146780.53219467882;148446;149043;119937;122884;123399;124268;127906;8003.19968003195;8790.604422801118;8900.109989001048;9114.680986165453;9338;63703.3629663716;64859;66311.33688663245;67172.664136679;68532.97200542096;64080;64100.43598256018;96736;97261.51369243108;102672;12140.874410074435;12298.877011230132;12313.44589493457;12556.560520381743;12749.55376561853;13029.413676384775;13221.867781322064;13513.189208647513;14011.719765604834;14128.43486260538;10503.42231177262;12275.877241227474;12469;12580.496780128693;12835.294058826854;12387.19483233587;12416.875831241572;12744;12999.870001299865;13054.54309099177;10229.28395012342;11289.20975531705;12236.571719990114;12278.386080696107;12405.62783116508;9283.860742088738;10258.43578603184;10447.216458765775;10624.84062739044;10746.677599672023;7693.615319233904;9279.211267042378;9994.800103998024;10586.041423207875;10860.78278434411 15:53:37 INFO - PROCESS | 2217 | __end_tp_report 15:53:37 INFO - PROCESS | 2217 | __start_cc_report 15:53:37 INFO - PROCESS | 2217 | _x_x_mozilla_cycle_collect,413 15:53:37 INFO - PROCESS | 2217 | __end_cc_report 15:53:37 INFO - PROCESS | 2217 | __startTimestamp1471301617454__endTimestamp 15:53:37 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | ------- Summary: start ------- 15:53:37 INFO - PROCESS | 2217 | Number of tests: 6 15:53:37 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | [#0] dojo.html Cycles:165 Average:5628.70 Median:5780.16 stddev:675.34 (11.7%) stddev-sans-first:639.19 15:53:37 INFO - PROCESS | 2217 | Values: 2773.4 3279.4 3293.1 3311.0 3313.9 5505.6 5531.3 5560.8 5596.3 5604.0 5394.4 5570.4 5611.1 5618.0 5642.4 5081.1 5086.0 5117.7 5165.1 5182.9 5087.5 5257.8 5279.1 5301.0 5314.7 5070.1 5178.9 5193.9 5201.8 5206.2 5104.4 5124.5 5171.5 5172.8 5177.1 4177.4 4443.3 4555.7 5036.9 5099.3 5358.0 5418.5 5463.6 5569.2 5584.6 5473.9 5837.4 6106.9 6123.1 6175.9 6139.2 6142.3 6183.8 6206.0 6214.4 5494.7 5618.2 5726.4 5745.1 5758.4 6226.0 6305.6 6311.9 6314.7 6323.1 6070.9 6075.8 6097.7 6102.7 6111.5 5991.2 6121.6 6133.2 6182.0 6196.1 5927.6 6032.5 6058.4 6078.0 6130.6 6127.2 6132.8 6134.8 6145.9 6151.6 4841.2 4876.6 4900.8 4905.8 4966.2 4314.0 4359.7 4384.4 4426.6 4437.2 5555.3 5558.2 5605.6 5729.1 5731.6 6146.6 6192.2 6215.5 6234.0 6239.7 5660.5 5677.5 5680.7 5688.8 5705.6 3995.5 5201.5 5304.3 5362.0 5396.8 6254.5 6257.7 6263.7 6293.4 6310.2 6128.4 6218.5 6232.0 6253.0 6254.8 6180.6 6225.0 6240.8 6252.7 6275.8 6081.0 6118.2 6140.4 6151.7 6153.9 6217.8 6234.1 6242.1 6245.5 6254.7 5765.6 5801.9 5938.3 5966.3 5995.9 5025.8 6014.2 6030.9 6042.4 6046.5 5633.2 5780.7 5806.7 5874.6 5879.1 5736.0 5816.8 5843.8 5858.1 5980.9 5775.9 5777.2 5780.2 5781.0 5794.8 15:53:37 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | [#1] ext.html Cycles:180 Average:69439.11 Median:40912.97 stddev:150811.74 (368.6%) stddev-sans-first:151145.97 15:53:37 INFO - PROCESS | 2217 | Values: 492.6 515.9 518.0 538.9 559.3 31556.8 39371.0 41422.4 41464.0 41528.4 31539.8 33720.5 34911.8 42061.0 42107.2 9657.5 9864.5 9870.5 9874.8 9891.6 8504.1 9165.2 9448.7 9685.6 9695.0 9659.1 9743.4 9782.7 9805.3 9827.5 9774.0 9779.9 9816.7 9822.2 9845.3 9673.5 9797.2 9846.5 9874.0 9923.0 41106.6 41152.6 41469.0 41526.6 41547.8 3315.6 3379.2 3392.9 3483.0 3859.2 31912.5 32695.8 32905.2 33053.5 33198.5 3246.3 3390.2 3458.4 3462.8 3475.9 494618.0 500184.0 500674.0 502070.5 503055.0 46347.8 49048.8 60807.7 60979.0 61253.7 63554.4 64151.7 64504.0 64594.2 64599.7 16069.1 16299.9 16331.8 16358.7 16396.9 12698.5 12718.3 12744.6 12748.4 12754.6 14007.5 16716.4 17219.0 17238.2 17398.0 6235.8 7230.1 7246.4 7261.7 7266.8 851.7 921.4 957.6 1052.5 1057.9 24500.6 30469.0 31139.5 31405.5 31492.8 1021.6 1049.3 1060.3 1089.6 1123.2 15428.7 16043.0 16070.9 16142.9 16491.0 664130.0 664774.0 666610.0 667190.0 674027.0 60447.7 60515.4 60536.8 60576.4 60908.7 1320.4 1378.5 1383.9 1401.7 1407.4 26079.7 27970.0 30173.5 30234.0 31987.4 51033.0 51317.5 51862.7 51864.5 52068.7 503706.0 508035.0 511408.0 512754.0 514836.4 26408.7 26727.5 26892.3 26905.7 26935.1 41687.8 47674.0 47822.8 48111.5 49044.0 39779.2 40145.4 40436.2 40802.3 41023.7 38948.4 39228.8 40389.0 40460.0 40546.8 37245.9 37303.0 37703.4 38088.0 38208.6 34036.8 34736.3 35208.1 35695.8 35900.5 25815.3 25936.5 25948.7 26056.5 26529.2 15:53:37 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | [#2] jquery.html Cycles:180 Average:36322.12 Median:27272.02 stddev:104592.75 (383.5%) stddev-sans-first:104851.30 15:53:37 INFO - PROCESS | 2217 | Values: 359.8 371.3 380.7 382.3 399.9 20021.0 21468.5 22078.8 22146.1 22399.8 20497.9 20824.8 21066.3 21207.4 21342.8 5869.1 5958.3 6121.3 6189.5 6203.5 4190.7 6078.8 6172.1 6173.2 6508.4 6771.7 6892.9 6909.0 6913.5 6919.8 6046.9 6671.7 6696.8 6774.5 6824.8 5326.3 5559.2 5828.1 5939.0 5951.9 21770.0 22460.0 22485.4 27063.7 27480.3 2324.9 2343.3 2688.7 2924.9 3010.2 15899.0 16149.3 16241.0 16393.3 16579.8 1794.9 1902.1 1918.6 1919.7 1926.8 97023.5 109496.0 110285.0 114919.0 115692.0 11087.1 11100.5 11118.8 11330.1 11466.7 13703.3 13752.4 13933.6 13951.4 14008.7 6958.7 8721.7 8723.3 8770.0 8845.1 7643.2 8613.8 8663.5 8701.1 8879.6 5646.3 5677.2 6766.6 6784.9 6801.6 1293.7 1650.5 1852.3 1914.1 1920.9 754.1 906.9 909.7 981.9 994.0 21322.6 21780.5 21891.3 22088.3 22123.9 926.8 949.5 961.4 968.5 1002.6 9432.8 10748.7 11634.0 11721.5 11810.7 606952.0 627005.0 633741.0 634529.0 640065.8 118139.8 128755.4 131373.0 131881.0 148880.0 964.4 968.5 998.5 1029.2 1035.1 18337.8 20061.8 20744.0 20860.9 20904.2 56796.7 58291.7 58292.4 58352.4 58534.4 77564.0 80532.0 84891.6 85709.0 87044.0 5606.1 7935.0 7971.1 8090.0 8176.6 10279.4 12499.6 12676.7 12784.6 12952.9 9420.6 10724.2 10747.5 11231.5 11333.5 9217.6 10762.4 11010.2 11051.4 11229.1 11067.6 11094.2 11282.3 11584.4 11642.6 7414.3 7841.9 7984.4 8077.1 8269.1 10763.3 11104.3 11132.2 11159.2 11309.9 15:53:37 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | [#3] mootools.html Cycles:180 Average:5743.17 Median:4770.32 stddev:3246.46 (68.1%) stddev-sans-first:3240.14 15:53:37 INFO - PROCESS | 2217 | Values: 1531.3 1550.6 1766.4 1775.5 1854.2 7222.6 8031.8 8481.5 9049.3 9064.5 8688.1 8886.4 8895.8 8909.0 8933.5 1819.5 1970.0 2167.0 2270.3 2391.4 2011.4 2031.4 2305.0 2392.9 2393.6 1964.6 2368.5 2369.7 2372.3 2393.6 2342.2 2345.2 2356.2 2366.5 2368.3 2332.7 2367.2 2369.7 2376.7 2385.4 8949.3 8972.0 8989.9 9008.3 9008.8 5251.2 5286.1 5399.0 5401.9 5418.3 3537.4 3611.0 3721.8 3727.3 3752.1 1074.0 1111.7 1113.9 1129.8 1131.3 9684.9 11562.3 11829.5 11927.9 11928.9 4553.5 4657.7 4790.9 4831.2 4850.0 10013.5 10057.0 10134.0 10144.6 10150.5 5345.7 5372.4 5376.0 5397.3 5490.2 4428.7 4749.7 4877.0 4888.6 4935.5 3890.5 3932.5 3978.2 4009.3 4055.6 1302.9 1309.3 1314.4 1321.9 1323.7 776.3 874.5 888.9 904.5 922.7 5757.7 5770.9 5868.2 5961.8 6074.6 432.9 434.6 439.0 447.1 447.4 3594.1 3978.8 4039.6 4045.5 4100.9 9608.0 10043.6 10892.9 11035.3 11063.4 10279.8 10874.5 10922.4 11013.6 11095.9 7959.4 8225.0 8290.2 8298.4 8319.0 5967.3 6040.9 6043.4 6117.4 6201.1 9432.6 10168.0 10300.7 10334.5 10337.0 8851.4 10316.0 10358.4 10359.5 10361.5 7010.4 7595.5 7784.6 7803.4 8184.7 8394.2 8581.6 8587.2 8588.7 8599.5 7579.5 7605.7 7623.5 7762.9 7795.6 7467.3 7491.8 7533.1 7533.2 7737.4 7024.2 7153.0 7156.9 7158.6 7178.9 5003.1 5028.6 5088.8 5135.3 5160.4 4399.3 5039.5 5156.3 5207.9 5265.4 15:53:37 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | [#4] prototype.html Cycles:180 Average:4608.24 Median:5036.56 stddev:1438.97 (28.6%) stddev-sans-first:1405.71 15:53:37 INFO - PROCESS | 2217 | Values: 271.7 301.5 312.3 313.2 318.0 4449.4 5408.3 5526.2 5554.7 5620.9 5433.6 5584.8 5602.4 5613.4 5644.3 3970.0 4252.8 4254.7 4261.9 4263.6 4108.7 4135.7 4293.8 4302.2 4338.5 3733.9 3855.4 4014.9 4054.0 4160.2 4229.9 4267.4 4270.6 4278.2 4293.0 3701.2 3713.9 3739.3 3740.3 3750.8 4849.5 5412.6 5428.7 5442.9 5473.5 3890.5 3933.9 4349.4 4553.6 4918.8 5464.0 5646.1 5873.0 5897.4 5955.4 3771.4 3836.1 3899.2 4060.8 4089.0 5197.2 5514.9 5659.7 5761.0 6005.5 4166.5 4184.8 4190.6 4193.5 4196.9 3761.5 3974.2 4169.0 4214.6 4220.5 4415.9 4870.8 4903.4 4934.7 4947.1 5887.0 5910.1 5930.7 6004.4 6023.2 1246.8 1421.5 1425.6 1441.5 1461.9 752.9 797.8 812.4 861.7 876.8 3925.9 4585.7 4652.2 4671.7 4689.6 4578.7 5047.6 5059.7 5063.6 5072.9 3981.3 4065.9 4456.7 4653.6 4653.9 2229.4 2334.1 2555.7 2646.4 2654.8 4463.6 4838.4 5025.5 5240.3 5252.3 4742.8 4934.0 5082.5 5153.5 5201.7 5016.6 5261.9 6337.9 6419.0 6451.3 5488.8 6176.3 6187.4 6223.3 6253.0 5048.8 5320.2 5836.0 5888.4 6161.7 5565.7 5641.8 5863.9 6342.4 6417.8 3427.2 4020.0 4031.9 4046.0 4065.2 5218.9 5642.7 5845.4 5950.9 6146.0 4961.7 5091.5 5926.6 5977.9 6011.3 5135.3 5838.4 5910.9 5923.5 5975.3 4747.5 5741.2 5820.7 5835.5 5899.8 5925.9 5932.9 5939.8 6009.6 6024.3 5140.6 5405.8 5768.0 5846.8 5859.8 15:53:37 INFO - PROCESS | 2217 | 15:53:37 INFO - PROCESS | 2217 | [#5] yui.html Cycles:180 Average:26094.85 Median:3800.41 stddev:43186.67 (1136.4%) stddev-sans-first:43265.77 15:53:37 INFO - PROCESS | 2217 | Values: 714.8 739.3 765.2 800.3 856.3 15215.1 15570.9 16173.4 16291.4 16321.8 14392.7 14534.9 14629.5 14629.6 14674.6 689.4 842.9 847.5 862.9 868.9 861.4 869.4 873.1 875.1 875.4 929.6 930.4 931.4 933.1 933.1 921.2 924.7 924.7 925.1 925.8 681.2 681.8 682.6 683.3 683.4 15383.5 15614.4 15782.2 15782.7 15815.2 14890.4 14947.9 14956.7 14965.6 15066.6 9832.9 11974.9 11998.2 12142.2 12509.9 3063.6 3620.2 3864.1 4055.3 4128.0 120478.6 123138.4 125140.0 125740.4 126160.0 9995.9 11373.7 11456.4 11628.8 11943.2 20739.3 24523.9 24584.5 24656.8 24679.0 8331.3 8337.6 8359.7 8505.8 8506.1 4473.1 4601.5 4606.0 4679.2 4814.3 3681.7 3772.8 3785.3 3795.4 3805.5 653.6 659.1 662.8 672.1 677.7 608.7 630.3 676.5 695.0 696.4 9509.2 9638.8 9666.8 9784.2 9972.2 528.6 606.0 679.8 684.2 690.2 4579.3 4716.9 4718.9 4724.4 4725.8 138427.0 159880.2 168936.0 171701.0 173791.0 103312.0 136328.3 146780.5 148446.0 149043.0 119937.0 122884.0 123399.0 124268.0 127906.0 8003.2 8790.6 8900.1 9114.7 9338.0 63703.4 64859.0 66311.3 67172.7 68533.0 64080.0 64100.4 96736.0 97261.5 102672.0 12140.9 12298.9 12313.4 12556.6 12749.6 13029.4 13221.9 13513.2 14011.7 14128.4 10503.4 12275.9 12469.0 12580.5 12835.3 12387.2 12416.9 12744.0 12999.9 13054.5 10229.3 11289.2 12236.6 12278.4 12405.6 9283.9 10258.4 10447.2 10624.8 10746.7 7693.6 9279.2 9994.8 10586.0 10860.8 15:53:37 INFO - PROCESS | 2217 | -------- Summary: end -------- 15:53:37 INFO - PROCESS | 2217 | 15:53:38 INFO - TEST-INFO | 2217: exit 0 15:53:38 INFO - TEST-OK | dromaeo_css | took 1113342ms 15:53:38 INFO - TEST-START | kraken 15:53:38 INFO - operating with platform_type : mac_ 15:53:38 INFO - Initialising browser for kraken test... 15:53:38 INFO - TEST-INFO | started process 2222 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/tmprsl4GA/profile http://localhost:52517/getInfo.html) 15:53:40 INFO - PROCESS | 2222 | __metrics Screen width/height:1600/1200 15:53:40 INFO - PROCESS | 2222 | colorDepth:24 15:53:40 INFO - PROCESS | 2222 | Browser inner width/height: 1024/689 15:53:40 INFO - PROCESS | 2222 | __metrics 15:53:41 ERROR - PROCESS | 2222 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 15:53:41 INFO - TEST-INFO | 2222: exit 0 15:53:41 INFO - Browser initialized. 15:53:41 INFO - Running cycle 1/1 for kraken test... 15:53:41 INFO - TEST-INFO | started process 2224 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/T/tmprsl4GA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:53:53 INFO - PROCESS | 2224 | RSS: Main: 239529984 15:53:53 INFO - PROCESS | 2224 | 15:53:56 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52517/tests/kraken/driver.html?testName=audio-beat-detection) 15:53:57 INFO - PROCESS | 2224 | RSS: Main: 252387328 15:53:57 INFO - PROCESS | 2224 | 15:54:00 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52517/tests/kraken/driver.html?testName=audio-dft) 15:54:00 INFO - PROCESS | 2224 | RSS: Main: 261111808 15:54:00 INFO - PROCESS | 2224 | 15:54:04 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52517/tests/kraken/driver.html?testName=audio-fft) 15:54:04 INFO - PROCESS | 2224 | RSS: Main: 264028160 15:54:04 INFO - PROCESS | 2224 | 15:54:06 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52517/tests/kraken/driver.html?testName=audio-oscillator) 15:54:07 INFO - PROCESS | 2224 | RSS: Main: 266399744 15:54:07 INFO - PROCESS | 2224 | 15:54:09 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52517/tests/kraken/driver.html?testName=imaging-gaussian-blur) 15:54:10 INFO - PROCESS | 2224 | RSS: Main: 266780672 15:54:10 INFO - PROCESS | 2224 | 15:54:12 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52517/tests/kraken/driver.html?testName=imaging-darkroom) 15:54:13 INFO - PROCESS | 2224 | RSS: Main: 267264000 15:54:13 INFO - PROCESS | 2224 | 15:54:16 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52517/tests/kraken/driver.html?testName=imaging-desaturate) 15:54:17 INFO - PROCESS | 2224 | RSS: Main: 266735616 15:54:17 INFO - PROCESS | 2224 | 15:54:20 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52517/tests/kraken/driver.html?testName=json-parse-financial) 15:54:21 INFO - PROCESS | 2224 | RSS: Main: 267587584 15:54:21 INFO - PROCESS | 2224 | 15:54:22 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52517/tests/kraken/driver.html?testName=json-stringify-tinderbox) 15:54:23 INFO - PROCESS | 2224 | RSS: Main: 267198464 15:54:23 INFO - PROCESS | 2224 | 15:54:25 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52517/tests/kraken/driver.html?testName=stanford-crypto-aes) 15:54:25 INFO - PROCESS | 2224 | RSS: Main: 267350016 15:54:25 INFO - PROCESS | 2224 | 15:54:28 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52517/tests/kraken/driver.html?testName=stanford-crypto-ccm) 15:54:28 INFO - PROCESS | 2224 | RSS: Main: 267366400 15:54:28 INFO - PROCESS | 2224 | 15:54:31 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52517/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 15:54:32 INFO - PROCESS | 2224 | RSS: Main: 267141120 15:54:32 INFO - PROCESS | 2224 | 15:54:35 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52517/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 15:54:35 INFO - PROCESS | 2224 | RSS: Main: 267661312 15:54:35 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | Cycle 1(1): loaded http://localhost:52517/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52517/tests/kraken/driver.html?testName=ai-astar) 15:54:37 INFO - PROCESS | 2224 | RSS: Main: 268673024 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | __start_tp_report 15:54:37 INFO - PROCESS | 2224 | _x_x_mozilla_page_load 15:54:37 INFO - PROCESS | 2224 | _x_x_mozilla_page_load_details 15:54:37 INFO - PROCESS | 2224 | |i|pagename|runs| 15:54:37 INFO - PROCESS | 2224 | |0;ai-astar;105;119;124;117;98;165;172;149;117;119 15:54:37 INFO - PROCESS | 2224 | |1;audio-beat-detection;144;111;170;180;109;131;154;112;160;111 15:54:37 INFO - PROCESS | 2224 | |2;audio-dft;197;267;252;201;197;198;200;201;198;198 15:54:37 INFO - PROCESS | 2224 | |3;audio-fft;71;83;78;165;59;58;61;61;146;70 15:54:37 INFO - PROCESS | 2224 | |4;audio-oscillator;69;71;118;71;72;75;118;72;73;121 15:54:37 INFO - PROCESS | 2224 | |5;imaging-gaussian-blur;127;88;91;89;91;87;91;88;90;89 15:54:37 INFO - PROCESS | 2224 | |6;imaging-darkroom;115;119;96;97;96;97;101;96;100;107 15:54:37 INFO - PROCESS | 2224 | |7;imaging-desaturate;150;90;99;146;91;100;146;102;149;136 15:54:37 INFO - PROCESS | 2224 | |8;json-parse-financial;52;57;59;56;58;58;54;69;86;86 15:54:37 INFO - PROCESS | 2224 | |9;json-stringify-tinderbox;82;98;70;79;78;80;76;70;72;72 15:54:37 INFO - PROCESS | 2224 | |10;stanford-crypto-aes;88;111;111;89;88;86;92;92;90;87 15:54:37 INFO - PROCESS | 2224 | |11;stanford-crypto-ccm;139;139;141;137;166;143;153;165;157;139 15:54:37 INFO - PROCESS | 2224 | |12;stanford-crypto-pbkdf2;167;171;178;173;172;175;171;172;175;172 15:54:37 INFO - PROCESS | 2224 | |13;stanford-crypto-sha256-iterative;70;73;68;69;70;66;70;69;70;70 15:54:37 INFO - PROCESS | 2224 | __end_tp_report 15:54:37 INFO - PROCESS | 2224 | __start_cc_report 15:54:37 INFO - PROCESS | 2224 | _x_x_mozilla_cycle_collect,1065 15:54:37 INFO - PROCESS | 2224 | __end_cc_report 15:54:37 INFO - PROCESS | 2224 | __startTimestamp1471301677881__endTimestamp 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | ------- Summary: start ------- 15:54:37 INFO - PROCESS | 2224 | Number of tests: 14 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#0] ai-astar Cycles:10 Average:128.50 Median:136.50 stddev:24.93 (18.3%) stddev-sans-first:24.95 15:54:37 INFO - PROCESS | 2224 | Values: 105.0 119.0 124.0 117.0 98.0 165.0 172.0 149.0 117.0 119.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#1] audio-beat-detection Cycles:10 Average:138.20 Median:149.00 stddev:27.05 (18.2%) stddev-sans-first:28.61 15:54:37 INFO - PROCESS | 2224 | Values: 144.0 111.0 170.0 180.0 109.0 131.0 154.0 112.0 160.0 111.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#2] audio-dft Cycles:10 Average:210.90 Median:200.50 stddev:25.90 (12.9%) stddev-sans-first:26.98 15:54:37 INFO - PROCESS | 2224 | Values: 197.0 267.0 252.0 201.0 197.0 198.0 200.0 201.0 198.0 198.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#3] audio-fft Cycles:10 Average:85.20 Median:65.50 stddev:38.23 (58.4%) stddev-sans-first:40.20 15:54:37 INFO - PROCESS | 2224 | Values: 71.0 83.0 78.0 165.0 59.0 58.0 61.0 61.0 146.0 70.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#4] audio-oscillator Cycles:10 Average:86.00 Median:71.50 stddev:22.84 (31.9%) stddev-sans-first:23.38 15:54:37 INFO - PROCESS | 2224 | Values: 69.0 71.0 118.0 71.0 72.0 75.0 118.0 72.0 73.0 121.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#5] imaging-gaussian-blur Cycles:10 Average:93.10 Median:89.50 stddev:11.99 (13.4%) stddev-sans-first:1.50 15:54:37 INFO - PROCESS | 2224 | Values: 127.0 88.0 91.0 89.0 91.0 87.0 91.0 88.0 90.0 89.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#6] imaging-darkroom Cycles:10 Average:102.40 Median:96.00 stddev:8.46 (8.8%) stddev-sans-first:7.65 15:54:37 INFO - PROCESS | 2224 | Values: 115.0 119.0 96.0 97.0 96.0 97.0 101.0 96.0 100.0 107.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#7] imaging-desaturate Cycles:10 Average:120.90 Median:149.50 stddev:26.35 (17.6%) stddev-sans-first:25.75 15:54:37 INFO - PROCESS | 2224 | Values: 150.0 90.0 99.0 146.0 91.0 100.0 146.0 102.0 149.0 136.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#8] json-parse-financial Cycles:10 Average:63.50 Median:58.50 stddev:12.67 (21.7%) stddev-sans-first:12.74 15:54:37 INFO - PROCESS | 2224 | Values: 52.0 57.0 59.0 56.0 58.0 58.0 54.0 69.0 86.0 86.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#9] json-stringify-tinderbox Cycles:10 Average:77.70 Median:78.50 stddev:8.33 (10.6%) stddev-sans-first:8.69 15:54:37 INFO - PROCESS | 2224 | Values: 82.0 98.0 70.0 79.0 78.0 80.0 76.0 70.0 72.0 72.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#10] stanford-crypto-aes Cycles:10 Average:93.40 Median:88.50 stddev:9.48 (10.7%) stddev-sans-first:9.85 15:54:37 INFO - PROCESS | 2224 | Values: 88.0 111.0 111.0 89.0 88.0 86.0 92.0 92.0 90.0 87.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#11] stanford-crypto-ccm Cycles:10 Average:147.90 Median:148.00 stddev:11.34 (7.7%) stddev-sans-first:11.56 15:54:37 INFO - PROCESS | 2224 | Values: 139.0 139.0 141.0 137.0 166.0 143.0 153.0 165.0 157.0 139.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:172.60 Median:172.50 stddev:2.95 (1.7%) stddev-sans-first:2.33 15:54:37 INFO - PROCESS | 2224 | Values: 167.0 171.0 178.0 173.0 172.0 175.0 171.0 172.0 175.0 172.0 15:54:37 INFO - PROCESS | 2224 | 15:54:37 INFO - PROCESS | 2224 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.50 Median:70.00 stddev:1.78 (2.5%) stddev-sans-first:1.88 15:54:37 INFO - PROCESS | 2224 | Values: 70.0 73.0 68.0 69.0 70.0 66.0 70.0 69.0 70.0 70.0 15:54:37 INFO - PROCESS | 2224 | -------- Summary: end -------- 15:54:37 INFO - PROCESS | 2224 | 15:54:38 INFO - TEST-INFO | 2224: exit 0 15:54:38 INFO - TEST-OK | kraken | took 60643ms 15:54:38 INFO - SUITE-END | took 1173s 15:54:39 INFO - Completed test suite (00:19:34) 15:54:39 INFO - javascript benchmark 15:54:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7396.891488278904, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2773.403718200587, 3279.4097062528767, 3293.1108600677817, 3311.039798458447, 3313.933721325572, 5505.614606977513, 5531.308586426697, 5560.805371811987, 5596.27248457701, 5603.971980140093, 5394.406615272317, 5570.442955704438, 5611.130274807401, 5617.9719101404435, 5642.4357564243655, 5081.136206844845, 5086.033653605812, 5117.692938423688, 5165.096108181053, 5182.896342073175, 5087.465816089313, 5257.789688412459, 5279.076161671711, 5300.973495132519, 5314.681119132864, 5070.062038522885, 5178.8705282368055, 5193.922091168635, 5201.843944681666, 5206.193040078794, 5104.438511763703, 5124.5131712487255, 5171.456997015297, 5172.844814655567, 5177.068127737006, 4177.394277829698, 4443.333499974998, 4555.703879247838, 5036.924446133311, 5099.286099946011, 5357.973210133963, 5418.45815418455, 5463.562914966833, 5569.164625306196, 5584.6090773645865, 5473.945260547383, 5837.357890632027, 6106.938930610726, 6123.142760013601, 6175.938240617626, 6139.2325959255095, 6142.293636231846, 6183.752649893999, 6206.038064100072, 6214.440700336946, 5494.725263736797, 5618.185363122325, 5726.3700992890335, 5745.109508026263, 5758.42415758425, 6225.968870155621, 6305.590136641195, 6311.873762524816, 6314.71583778731, 6323.146375239376, 6070.939290607126, 6075.75696972125, 6097.695115244309, 6102.72537735803, 6111.480524155497, 5991.161237426763, 6121.632702037892, 6133.233345831771, 6181.979973304445, 6196.10156527301, 5927.555433342516, 6032.487238584682, 6058.363871793486, 6077.969610151921, 6130.601510901777, 6127.18952814863, 6132.819519597536, 6134.754609815646, 6145.877082458326, 6151.569390142737, 4841.2496063110275, 4876.634252431082, 4900.828471003498, 4905.828296009622, 4966.205407134913, 4314.029343397773, 4359.738415695068, 4384.430024096847, 4426.557344265612, 4437.156940181355, 5555.2500412444615, 5558.166275058693, 5605.5895964735555, 5729.111987641839, 5731.627444216113, 6146.631202127886, 6192.225971753531, 6215.533834962396, 6234.0, 6239.656818874914, 5660.518855897295, 5677.489025987681, 5680.715964201773, 5688.829335119953, 5705.5720820938595, 3995.4805875236034, 5201.531862132426, 5304.257403963448, 5361.973190134102, 5396.811111611075, 6254.530910181755, 6257.74969001244, 6263.749450022039, 6293.402126797947, 6310.211223597051, 6128.383357565242, 6218.53360997936, 6232.034034724625, 6252.999520076948, 6254.781082662085, 6180.567360284737, 6225.0, 6240.7503699851495, 6252.718627661675, 6275.780347687809, 6081.0, 6118.235220597426, 6140.385961403824, 6151.692415379123, 6153.938460615515, 6217.813465596039, 6234.096056071753, 6242.063690446469, 6245.531585131042, 6254.655993920196, 5765.56758243125, 5801.94198058014, 5938.317093534299, 5966.254218222723, 5995.850103747442, 5025.824096156617, 6014.248218972629, 6030.879382412415, 6042.3655516170165, 6046.455818976313, 5633.1831884375715, 5780.7398667060925, 5806.65160090396, 5874.618149820248, 5879.059350503899, 5736.0, 5816.796412125555, 5843.766249350148, 5858.121281807763, 5980.9401905980385, 5775.94224057754, 5777.162311464898, 5780.161876527964, 5781.0, 5794.768209271582], "value": 5583.055253896859, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [492.608376340809, 515.9355080614923, 518.0467938992253, 538.9487998640128, 559.2673597587161, 31556.84221578889, 39371.0157246069, 41422.37866432006, 41464.0, 41528.37707434391, 31539.84230078852, 33720.49419258713, 34911.82544087276, 42061.0, 42107.157856842845, 9657.517124143782, 9864.506774661275, 9870.506474676273, 9874.753131171743, 9891.55488003038, 8504.064552899175, 9165.175134237918, 9448.716538503855, 9685.564149613248, 9694.951525242364, 9659.082387173208, 9743.366681165737, 9782.706518804447, 9805.264605154607, 9827.508624568778, 9773.951130244339, 9779.902200978006, 9816.705498835046, 9822.214222862154, 9845.310828242025, 9673.467959262238, 9797.216222702167, 9846.458444785534, 9874.01259874014, 9922.9503852481, 41106.56127035569, 41152.588474115175, 41469.0, 41526.58473415257, 41547.7922610385, 3315.552400425936, 3379.1889946412684, 3392.8982130536124, 3483.0421634050585, 3859.2281543691092, 31912.521312180335, 32695.83652081748, 32905.17737056569, 33053.504197437054, 33198.502022469685, 3246.2695893424025, 3390.2202493426403, 3458.360203362361, 3462.8441720122655, 3475.94786078209, 494618.0, 500184.0, 500674.0, 502070.48964755307, 503055.0, 46347.768261158475, 49048.75475622599, 60807.695961520796, 60979.0, 61253.69373153106, 63554.36445635577, 64151.679241604426, 64504.0, 64594.24869015748, 64599.67700161563, 16069.116198609188, 16299.918500407422, 16331.775116866282, 16358.672826543641, 16396.918015410087, 12698.492060317669, 12718.300493472763, 12744.553940612033, 12748.426320815586, 12754.553590624284, 14007.509737159355, 16716.41492547755, 17219.0, 17238.224279907434, 17398.0431076292, 6235.781747638811, 7230.132384113835, 7246.420286377077, 7261.709531618676, 7266.818329541804, 851.7104184577273, 921.3964853021282, 957.6313119449062, 1052.5421441672897, 1057.9259451838452, 24500.632490512657, 30469.0, 31139.5088392928, 31405.52891706626, 31492.842535787175, 1021.5760459409262, 1049.2917280835406, 1060.3213943076437, 1089.629525961177, 1123.2025262063862, 15428.691426171414, 16042.957207781457, 16070.919645401931, 16142.919285403732, 16491.0, 664130.0, 664774.0, 666610.0, 667190.0, 674027.0, 60447.69776151091, 60515.39484605098, 60536.78926421447, 60576.39423605796, 60908.69545652244, 1320.4058173821818, 1378.4830688491816, 1383.9169649821042, 1401.7196560687698, 1407.4370251899118, 26079.739202607732, 27970.021049263993, 30173.547396789505, 30234.0, 31987.360252794348, 51033.0, 51317.48682513127, 51862.740686296325, 51864.481355187476, 52068.73965630148, 503706.0, 508035.0, 511408.0, 512754.0, 514836.3872709637, 26408.735912640626, 26727.465450690488, 26892.327691807863, 26905.730942690323, 26935.057272995353, 41687.791561042, 47674.04651906873, 47822.76088619535, 48111.5188848121, 49044.01911961812, 39779.220974007425, 40145.39781903332, 40436.191276173726, 40802.27972368756, 41023.66692329978, 38948.41577376285, 39228.803855980535, 40389.0, 40460.0, 40546.797266013484, 37245.882623521335, 37303.0, 37703.434448482745, 38088.04779880525, 38208.617913820504, 34036.82981585076, 34736.30527389488, 35208.11979700528, 35695.82152089327, 35900.461493077106, 25815.34221405646, 25936.481270374865, 25948.74051259463, 26056.478870422863, 26529.204123876316], "value": 19990.305558767704, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [359.82728290420596, 371.2611902314395, 380.6840322532299, 382.298482285007, 399.9381641741176, 20021.0, 21468.4632884178, 22078.77921220787, 22146.114155433785, 22399.776002239993, 20497.872617006058, 20824.791752082514, 21066.262680806176, 21207.363779086612, 21342.826144562045, 5869.148973398855, 5958.255218097738, 6121.326654068072, 6189.473894718932, 6203.503719702436, 4190.7485550866895, 6078.787242446515, 6172.105044768506, 6173.166622505949, 6508.381703738138, 6771.695273712695, 6892.931070689304, 6909.032735417046, 6913.516053876231, 6919.827004324882, 6046.909296360558, 6671.733130674767, 6696.799096027103, 6774.45804335652, 6824.829379265509, 5326.307580014612, 5559.221708960748, 5828.0966450200285, 5939.0, 5951.880962380728, 21770.0, 22460.0, 22485.43786405353, 27063.72936270632, 27480.312992175157, 2324.941876453085, 2343.3204370732637, 2688.7445692659167, 2924.8830046798103, 3010.247438140465, 15899.0, 16149.273282702306, 16241.0, 16393.262303196265, 16579.834201657948, 1794.9192286347015, 1902.1155162849202, 1918.6258679557493, 1919.7408349872728, 1926.7591551056119, 97023.51488242584, 109496.0, 110285.0, 114919.0, 115692.0, 11087.113030957504, 11100.500477478532, 11118.833217501582, 11330.09359251258, 11466.656000320003, 13703.314834258446, 13752.449902003807, 13933.58199254024, 13951.372188251553, 14008.719825603635, 6958.686859091353, 8721.738347849448, 8723.302135829246, 8769.956150219208, 8845.115488451233, 7643.235676432312, 8613.827723445496, 8663.48019118855, 8701.129887011375, 8879.556022198993, 5646.265985421869, 5677.205191273225, 6766.560173588799, 6784.864302713918, 6801.591904485746, 1293.734784369202, 1650.5460998225585, 1852.2961274715792, 1914.1482040492126, 1920.9231630734894, 754.1176823116966, 906.8730377747121, 909.6543313540813, 981.9116279534876, 993.9950300248453, 21322.573548528944, 21780.45548861291, 21891.343259702233, 22088.337349879206, 22123.889380552995, 926.7766548156369, 949.4967667136428, 961.3847137831793, 968.4625033106694, 1002.644061358222, 9432.811343773086, 10748.677539673823, 11633.986274735204, 11721.531138754355, 11810.704732381588, 606952.0, 627005.0, 633741.0, 634529.0, 640065.799671008, 118139.81860181288, 128755.35622321829, 131373.0, 131881.0, 148880.0, 964.4165280005636, 968.5447839515416, 998.5057396588589, 1029.1715169288793, 1035.0839507036328, 18337.816621834143, 20061.799382005993, 20744.0, 20860.895695521423, 20904.1638334471, 56796.716016419654, 58291.708541457025, 58292.4170758287, 58352.416475834696, 58534.414655852896, 77564.0, 80531.98670033296, 84891.5755421219, 85709.0, 87044.0, 5606.074997625509, 7935.008123984502, 7971.123176450702, 8090.0291964962225, 8176.591170441335, 10279.43069909889, 12499.625011249676, 12676.683082923, 12784.61646150617, 12952.935235323763, 9420.623175073195, 10724.249302549058, 10747.46262686847, 11231.494582743959, 11333.546658133582, 9217.585208665492, 10762.408067556047, 11010.174236932422, 11051.447427628425, 11229.101671866394, 11067.557297708323, 11094.223404361617, 11282.323060616389, 11584.362860042778, 11642.592509262135, 7414.332710055905, 7841.902133701173, 7984.401169912164, 8077.111517733162, 8269.131741167092, 10763.331683589056, 11104.333739975627, 11132.220744548127, 11159.218854680095, 11309.886901131213], "value": 9920.368120081079, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1531.2573401900077, 1550.5580909440807, 1766.3641089207883, 1775.5117342730755, 1854.1934258597512, 7222.602756848384, 8031.839363212733, 8481.533515656636, 9049.321300902426, 9064.501452420114, 8688.131186881308, 8886.377953543255, 8895.822083558325, 8908.955455222715, 8933.508657023878, 1819.4996375996575, 1969.970450443241, 2167.035669127239, 2270.318904328703, 2391.390195500145, 2011.3965810256936, 2031.3601215617107, 2305.0318866076286, 2392.940176495593, 2393.628987506939, 1964.6168997045581, 2368.5144545368157, 2369.727481339642, 2372.3001714494267, 2393.628987506939, 2342.227065068523, 2345.2260753951327, 2356.1988923765916, 2366.503034362786, 2368.2658375903525, 2332.731735850365, 2367.171489978511, 2369.7393286738443, 2376.6910301660846, 2385.3678775124604, 8949.328800339936, 8972.013078561353, 8989.865152022725, 9008.324375671786, 9008.819823603557, 5251.159814429673, 5286.07493688603, 5399.028174928511, 5401.892612014528, 5418.29562156921, 3537.3809583323073, 3611.0, 3721.79530125843, 3727.254549090193, 3752.0994961209385, 1073.955607250165, 1111.6831702964616, 1113.8719047309582, 1129.7571022230177, 1131.2533727739735, 9684.934657187703, 11562.30626162433, 11829.526818927232, 11927.940360298144, 11928.880711192951, 4553.453585569687, 4657.697249678828, 4790.904181916412, 4831.178699621073, 4849.951500485021, 10013.549390277454, 10057.044580764816, 10134.0, 10144.644937427154, 10150.492475376202, 5345.70598617072, 5372.382176049726, 5376.0, 5397.271368365299, 5490.1764735289225, 4428.689991700615, 4749.738764367993, 4877.0, 4888.584470319992, 4935.481774413706, 3890.4747859039235, 3932.488776459042, 3978.244133614604, 4009.3384591542654, 4055.5538890721996, 1302.8762267584564, 1309.3453273363318, 1314.4413624209672, 1321.8810307072217, 1323.7021670124145, 776.3401109057256, 874.5015341255423, 888.9466632002101, 904.5296445848122, 922.6586163119689, 5757.712114394263, 5770.942290577124, 5868.23712917318, 5961.791337303173, 6074.574779765462, 432.8831215571778, 434.611023134293, 438.97146685465344, 447.05447977527297, 447.44740245796413, 3594.137407022296, 3978.76127432355, 4039.5758445363404, 4045.4943132108488, 4100.8675488745685, 9608.0, 10043.648472303581, 10892.891071089347, 11035.337879727242, 11063.446827658585, 10279.845802312972, 10874.45627718611, 10922.399268040175, 11013.559457621766, 11095.944520277348, 7959.442839001214, 8225.012998440225, 8290.170982901782, 8298.377621678399, 8318.960129983752, 5967.31375891778, 6040.909386359121, 6043.425874541911, 6117.357677443804, 6201.131841542278, 9432.575534101119, 10167.983201679774, 10300.742481438025, 10334.5349459273, 10337.0, 8851.380403371702, 10316.0, 10358.430286334324, 10359.482025898524, 10361.481925903523, 7010.369066784014, 7595.5442673439775, 7784.610769461618, 7803.414743894345, 8184.713535026245, 8394.202550757669, 8581.570921453778, 8587.22714955657, 8588.742337729878, 8599.484030958163, 7579.5073320236215, 7605.6577454015805, 7623.4663573549315, 7762.92237077622, 7795.571243581658, 7467.290607392289, 7491.838764991435, 7533.133689625544, 7533.171351151478, 7737.381009519338, 7024.192217895007, 7152.964235178791, 7156.892646610201, 7158.570485770871, 7178.892316615151, 5003.099442100457, 5028.572571331478, 5088.771005304696, 5135.281060651587, 5160.354955630546, 4399.296112621965, 5039.47085556026, 5156.2523434101095, 5207.921881171861, 5265.420803711512], "value": 4522.84703418205, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [271.7119852955867, 301.4528630535579, 312.2942150739329, 313.23882964396523, 318.039520647644, 4449.421575195228, 5408.2698835657175, 5526.19870118833, 5554.666719996803, 5620.94835385084, 5433.587267310498, 5584.776608935648, 5602.38373778884, 5613.354464236614, 5644.322681278242, 3969.9554729314427, 4252.808623611937, 4254.659627229814, 4261.893452663678, 4263.573642635727, 4108.691848111389, 4135.73117747347, 4293.849715259967, 4302.2255993921235, 4338.501072376685, 3733.8693145739903, 3855.363864962278, 4014.8795536133816, 4053.9662386091504, 4160.230357383879, 4229.873103806891, 4267.423897773791, 4270.636995855356, 4278.2085314216965, 4293.0, 3701.1857391373856, 3713.9442908356395, 3739.2895349883433, 3740.2706472237924, 3750.8124593770476, 4849.4908034656555, 5412.646838290428, 5428.728563571805, 5442.9386269677425, 5473.452654734495, 3890.513685789276, 3933.8819835404984, 4349.412829268072, 4553.612942899857, 4918.803247870117, 5463.983971780738, 5646.064046695696, 5872.970635146839, 5897.439743224387, 5955.434233747787, 3771.3600479664346, 3836.117692930614, 3899.2396482685886, 4060.796960151981, 4089.0, 5197.220416937452, 5514.889702205974, 5659.660420374791, 5760.971195143998, 6005.489533389624, 4166.541680415152, 4184.832606695759, 4190.622843944059, 4193.51774545925, 4196.895077623023, 3761.5110035695184, 3974.205158968218, 4168.95776055986, 4214.599613036818, 4220.53574106848, 4415.933760993587, 4870.780814863339, 4903.387076615423, 4934.654574179773, 4947.084789313988, 5886.970565147232, 5910.143029260733, 5930.673812940329, 6004.42957918997, 6023.186869772612, 1246.8316777234957, 1421.46694989379, 1425.6364627020043, 1441.5459130374109, 1461.875740562064, 752.9322360987537, 797.8085259537669, 812.3663542436909, 861.6984055580497, 876.8381893990488, 3925.9018524536546, 4585.72485650862, 4652.232381657056, 4671.743054131987, 4689.648276379286, 4578.748168850745, 5047.570956468668, 5059.671121377099, 5063.569596584258, 5072.920102757852, 3981.303271927401, 4065.8576949806616, 4456.688031837805, 4653.557911998355, 4653.906921861544, 2229.4314949687728, 2334.124703236286, 2555.6549865768256, 2646.3781011462293, 2654.840709557394, 4463.642908567307, 4838.395200599925, 5025.547700706954, 5240.292560504283, 5252.264682944391, 4742.762861856893, 4933.9506604933495, 5082.467684958992, 5153.484651534816, 5201.661891977009, 5016.623753218596, 5261.868453288622, 6337.859185346681, 6418.967905160538, 6451.258105317855, 5488.765027868698, 6176.320604733565, 6187.381261873777, 6223.315435302204, 6253.0, 5048.823291184791, 5320.201969704575, 5835.970820146042, 5888.438529239795, 6161.661108639068, 5565.66424058215, 5641.802536911188, 5863.882722345444, 6342.39747224013, 6417.839554011187, 3427.1774774053547, 4019.979900100481, 4031.879043628696, 4046.0, 4065.2479291331197, 5218.869528261824, 5642.6614403135945, 5845.386234445492, 5950.899083669535, 6146.0473626587955, 4961.70229786214, 5091.490850914879, 5926.585139040226, 5977.880442391215, 6011.338752737282, 5135.332406787244, 5838.4453476919625, 5910.940890591211, 5923.466887980103, 5975.25309336333, 4747.454042785124, 5741.196232527533, 5820.679862607597, 5835.533157347317, 5899.793507227227, 5925.851853703692, 5932.851678708067, 5939.792107276225, 6009.579329446897, 6024.277086749618, 5140.588752899685, 5405.78376864921, 5768.0, 5846.766129354948, 5859.794907178399], "value": 4141.81780261738, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [714.7605552140033, 739.349372552154, 765.1774342581723, 800.3157300508062, 856.3021137772716, 15215.087094774308, 15570.922145389257, 16173.43392981246, 16291.429799957004, 16321.83678163218, 14392.71214575708, 14534.854651453483, 14629.487967921124, 14629.634259143526, 14674.63313417165, 689.3623398356525, 842.8988521377444, 847.5126802088809, 862.9352798540103, 868.8609822428413, 861.4228466927143, 869.395769939892, 873.1443185678039, 875.0549406640813, 875.4440930009458, 929.604917909889, 930.3534043839534, 931.3945935142144, 933.0948979489918, 933.1042199488465, 921.230772305126, 924.6671198368582, 924.7364501117149, 925.0656836595053, 925.8472352061935, 681.2404169351187, 681.7784220128478, 682.6450245872119, 683.2859661653534, 683.4259222253331, 15383.461578844686, 15614.375424982987, 15782.210889455597, 15782.684346313124, 15815.209239537977, 14890.404383824634, 14947.925260373737, 14956.700865982619, 14965.625859353495, 15066.623334416618, 9832.852507212398, 11974.86238807312, 11998.220115692538, 12142.150049496538, 12509.937450312691, 3063.6476805167244, 3620.2216523447587, 3864.14988702485, 4055.3105971984537, 4128.02991297045, 120478.59042819095, 123138.37631919666, 125140.0, 125740.37129814384, 126160.0, 9995.850062249072, 11373.658790236306, 11456.427178641035, 11628.825567616492, 11943.223690460092, 20739.274125405842, 24523.87738061334, 24584.5083098337, 24656.767161641845, 24679.01283948622, 8331.29184019353, 8337.624806883705, 8359.665613375397, 8505.829883402297, 8506.106858779738, 4473.083017981306, 4601.470830854428, 4605.953940460619, 4679.181143299909, 4814.277858321209, 3681.687056600219, 3772.830222639933, 3785.337565925952, 3795.35478968576, 3805.46723458716, 653.5719103986801, 659.0838734159522, 662.7746566167526, 672.122879642062, 677.6781029011279, 608.7352001879196, 630.2909227119491, 676.539952832069, 694.9610332552764, 696.4080531548245, 9509.191718703849, 9638.759031024281, 9666.806663866684, 9784.217262618973, 9972.152367048737, 528.5824198882916, 606.0394275074057, 679.7586856665911, 684.1619016704498, 690.1683471416931, 4579.335996280587, 4716.858494245178, 4718.8584342469785, 4724.362211101526, 4725.810967561259, 138427.0, 159880.20059899858, 168936.0, 171701.0, 173791.0, 103312.0, 136328.31835840957, 146780.53219467882, 148446.0, 149043.0, 119937.0, 122884.0, 123399.0, 124268.0, 127906.0, 8003.19968003195, 8790.604422801118, 8900.109989001048, 9114.680986165453, 9338.0, 63703.3629663716, 64859.0, 66311.33688663245, 67172.664136679, 68532.97200542096, 64080.0, 64100.43598256018, 96736.0, 97261.51369243108, 102672.0, 12140.874410074435, 12298.877011230132, 12313.44589493457, 12556.560520381743, 12749.55376561853, 13029.413676384775, 13221.867781322064, 13513.189208647513, 14011.719765604834, 14128.43486260538, 10503.42231177262, 12275.877241227474, 12469.0, 12580.496780128693, 12835.294058826854, 12387.19483233587, 12416.875831241572, 12744.0, 12999.870001299865, 13054.54309099177, 10229.28395012342, 11289.20975531705, 12236.571719990114, 12278.386080696107, 12405.62783116508, 9283.860742088738, 10258.43578603184, 10447.216458765775, 10624.84062739044, 10746.677599672023, 7693.615319233904, 9279.211267042378, 9994.800103998024, 10586.041423207875, 10860.78278434411], "value": 7896.353303271737, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1589.8000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 119.0, 124.0, 117.0, 98.0, 165.0, 172.0, 149.0, 117.0, 119.0], "value": 128.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 111.0, 170.0, 180.0, 109.0, 131.0, 154.0, 112.0, 160.0, 111.0], "value": 138.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [197.0, 267.0, 252.0, 201.0, 197.0, 198.0, 200.0, 201.0, 198.0, 198.0], "value": 210.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 83.0, 78.0, 165.0, 59.0, 58.0, 61.0, 61.0, 146.0, 70.0], "value": 85.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 71.0, 118.0, 71.0, 72.0, 75.0, 118.0, 72.0, 73.0, 121.0], "value": 86.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [127.0, 88.0, 91.0, 89.0, 91.0, 87.0, 91.0, 88.0, 90.0, 89.0], "value": 93.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 119.0, 96.0, 97.0, 96.0, 97.0, 101.0, 96.0, 100.0, 107.0], "value": 102.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 90.0, 99.0, 146.0, 91.0, 100.0, 146.0, 102.0, 149.0, 136.0], "value": 120.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 57.0, 59.0, 56.0, 58.0, 58.0, 54.0, 69.0, 86.0, 86.0], "value": 63.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 98.0, 70.0, 79.0, 78.0, 80.0, 76.0, 70.0, 72.0, 72.0], "value": 77.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 111.0, 111.0, 89.0, 88.0, 86.0, 92.0, 92.0, 90.0, 87.0], "value": 93.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 139.0, 141.0, 137.0, 166.0, 143.0, 153.0, 165.0, 157.0, 139.0], "value": 147.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 171.0, 178.0, 173.0, 172.0, 175.0, 171.0, 172.0, 175.0, 172.0], "value": 172.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 73.0, 68.0, 69.0, 70.0, 66.0, 70.0, 69.0, 70.0, 70.0], "value": 69.5, "unit": "score"}]}]} 15:54:39 INFO - Return code: 0 15:54:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 15:54:39 ERROR - # TBPL SUCCESS # 15:54:39 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 15:54:39 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 15:54:39 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 15:54:39 INFO - 2016-08-15 15:54:39.193 screenresolution[2229:21590] starting screenresolution argv=screenresolution get 15:54:39 INFO - 2016-08-15 15:54:39.196 screenresolution[2229:21590] Display 0: 1600x1200x32@60 15:54:39 INFO - 2016-08-15 15:54:39.202 screenresolution[2230:21593] starting screenresolution argv=screenresolution list 15:54:39 INFO - Available Modes on Display 0 15:54:39 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 15:54:39 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 15:54:39 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 15:54:39 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 15:54:39 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 15:54:39 INFO - Intel Iris: 15:54:39 INFO - Chipset Model: Intel Iris 15:54:39 INFO - Type: GPU 15:54:39 INFO - Bus: Built-In 15:54:39 INFO - VRAM (Dynamic, Max): 1536 MB 15:54:39 INFO - Vendor: Intel (0x8086) 15:54:39 INFO - Device ID: 0x0a2e 15:54:39 INFO - Revision ID: 0x0009 15:54:39 INFO - Displays: 15:54:39 INFO - Display: 15:54:39 INFO - Resolution: 1600 x 1200 @ 60 Hz 15:54:39 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 15:54:39 INFO - Display Serial Number: 1600x1200 60 15:54:39 INFO - Main Display: Yes 15:54:39 INFO - Mirror: Off 15:54:39 INFO - Online: Yes 15:54:39 INFO - Rotation: Supported 15:54:39 INFO - Return code: 0 15:54:39 INFO - Running post-action listener: _resource_record_post_action 15:54:39 INFO - [mozharness: 2016-08-15 22:54:39.436945Z] Finished run-tests step (success) 15:54:39 INFO - Running post-run listener: _resource_record_post_run 15:54:39 INFO - Total resource usage - Wall time: 1209s; CPU: 54.0%; Read bytes: 995328; Write bytes: 704850432; Read time: 13; Write time: 1984 15:54:39 INFO - TinderboxPrint: CPU usage
54.4% 15:54:39 INFO - TinderboxPrint: I/O read bytes / time
995,328 / 13 15:54:39 INFO - TinderboxPrint: I/O write bytes / time
704,850,432 / 1,984 15:54:39 INFO - TinderboxPrint: CPU idle
2,206.9 (45.6%) 15:54:39 INFO - TinderboxPrint: CPU system
979.6 (20.2%) 15:54:39 INFO - TinderboxPrint: CPU user
1,651.1 (34.1%) 15:54:39 INFO - TinderboxPrint: Swap in / out
405,958,656 / 0 15:54:39 INFO - install - Wall time: 35s; CPU: 55.0%; Read bytes: 389700096; Write bytes: 385058304; Read time: 29008; Write time: 742 15:54:39 INFO - run-tests - Wall time: 1175s; CPU: 54.0%; Read bytes: 991232; Write bytes: 296436736; Read time: 12; Write time: 1196 15:54:39 INFO - Running post-run listener: _upload_blobber_files 15:54:39 INFO - Blob upload gear active. 15:54:39 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 15:54:39 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 15:54:39 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'] 15:54:39 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 15:54:40 INFO - (blobuploader) - INFO - Open directory for files ... 15:54:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 15:54:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:54:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:54:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 15:54:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:54:41 INFO - (blobuploader) - INFO - Done attempting. 15:54:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 15:54:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:54:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:54:42 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 15:54:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:54:42 INFO - (blobuploader) - INFO - Done attempting. 15:54:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 15:54:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:54:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:54:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 15:54:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:54:44 INFO - (blobuploader) - INFO - Done attempting. 15:54:44 INFO - (blobuploader) - INFO - Iteration through files over. 15:54:44 INFO - Return code: 0 15:54:44 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 15:54:44 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 15:54:44 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/2361853557099fc217d50c6a8ca4e2c1fab063418f9df72e8621dbb8f95877e66e1f756f6b265dc3f1de37a90ce27bdf33182e47a56f18c1ae3db5635f74a936", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/5c3e6b06f877c06d89329076db7d073d9455726605a855724bc85cbc4a65c56cc179eedf27fb25e300a7ff76901355c9240a8e6eb9efd0fafa50e7208813d8c0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a99a7866344f3e1b8ab6b81b556a2901fa7f8857d12abe8069d8ed58d9f2de782b42a9690e7118372960a7d1b87a743e84c52b6dd498e611210f427c2362850d"} 15:54:44 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 15:54:44 INFO - Writing to file /builds/slave/test/properties/blobber_files 15:54:44 INFO - Contents: 15:54:44 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/2361853557099fc217d50c6a8ca4e2c1fab063418f9df72e8621dbb8f95877e66e1f756f6b265dc3f1de37a90ce27bdf33182e47a56f18c1ae3db5635f74a936", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/5c3e6b06f877c06d89329076db7d073d9455726605a855724bc85cbc4a65c56cc179eedf27fb25e300a7ff76901355c9240a8e6eb9efd0fafa50e7208813d8c0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a99a7866344f3e1b8ab6b81b556a2901fa7f8857d12abe8069d8ed58d9f2de782b42a9690e7118372960a7d1b87a743e84c52b6dd498e611210f427c2362850d"} 15:54:44 INFO - Running post-run listener: copy_logs_to_upload_dir 15:54:44 INFO - Copying logs to upload dir... 15:54:44 INFO - mkdir: /builds/slave/test/build/upload/logs 15:54:44 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1267.520869 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-08-15 15:54:44.796434) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-15 15:54:44.800078) ========= 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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners TMPDIR=/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/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/2361853557099fc217d50c6a8ca4e2c1fab063418f9df72e8621dbb8f95877e66e1f756f6b265dc3f1de37a90ce27bdf33182e47a56f18c1ae3db5635f74a936", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/5c3e6b06f877c06d89329076db7d073d9455726605a855724bc85cbc4a65c56cc179eedf27fb25e300a7ff76901355c9240a8e6eb9efd0fafa50e7208813d8c0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a99a7866344f3e1b8ab6b81b556a2901fa7f8857d12abe8069d8ed58d9f2de782b42a9690e7118372960a7d1b87a743e84c52b6dd498e611210f427c2362850d"} build_url:https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011036 build_url: 'https://queue.taskcluster.net/v1/task/ITWmU3Y2S3a6O1pnnfpXvg/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/2361853557099fc217d50c6a8ca4e2c1fab063418f9df72e8621dbb8f95877e66e1f756f6b265dc3f1de37a90ce27bdf33182e47a56f18c1ae3db5635f74a936", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/5c3e6b06f877c06d89329076db7d073d9455726605a855724bc85cbc4a65c56cc179eedf27fb25e300a7ff76901355c9240a8e6eb9efd0fafa50e7208813d8c0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a99a7866344f3e1b8ab6b81b556a2901fa7f8857d12abe8069d8ed58d9f2de782b42a9690e7118372960a7d1b87a743e84c52b6dd498e611210f427c2362850d"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-15 15:54:44.833044) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-15 15:54:44.833430) ========= 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.DmMh6QMDzf/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.iQuEQwvW7F/Listeners TMPDIR=/var/folders/q3/qr1dz7h156sc9qr571g_8l4r00000w/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.005016 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-15 15:54:44.881522) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-15 15:54:44.881844) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-15 15:54:44.882189) ========= ========= Total master_lag: 0.18 =========