builder: mozilla-central_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0172 starttime: 1470659754.92 results: success (0) buildid: 20160808030441 builduid: f603c1cd8c81472499074ffbf994b474 revision: e78975b53563d80c99ebfbdf8a9fbf6b829a8a48 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:54.920826) ========= master: http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:54.921344) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-08-08 05:35:54.921637) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-08-08 05:35:55.929541) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:55.929913) ========= 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.24v1Ola66r/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.UB4q0bazmy/Listeners TMPDIR=/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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-08 05:35:55-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 39.4M=0s 2016-08-08 05:35:56 (39.4 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.135887 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:56.088217) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:56.088550) ========= 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.24v1Ola66r/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.UB4q0bazmy/Listeners TMPDIR=/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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.027217 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:56.137752) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-08 05:35:56.138118) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev e78975b53563d80c99ebfbdf8a9fbf6b829a8a48 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev e78975b53563d80c99ebfbdf8a9fbf6b829a8a48 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.24v1Ola66r/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.UB4q0bazmy/Listeners TMPDIR=/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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-08 05:35:56,216 truncating revision to first 12 chars 2016-08-08 05:35:56,216 Setting DEBUG logging. 2016-08-08 05:35:56,216 attempt 1/10 2016-08-08 05:35:56,216 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/e78975b53563?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-08 05:35:56,844 unpacking tar archive at: mozilla-central-e78975b53563/testing/mozharness/ program finished with exit code 0 elapsedTime=0.894879 ========= master_lag: 0.80 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-08 05:35:57.832519) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:57.835886) ========= script_repo_revision: e78975b53563d80c99ebfbdf8a9fbf6b829a8a48 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:57.836305) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:57.836578) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-08 05:35:58.437683) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-08-08 05:35:58.438054) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.24v1Ola66r/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.UB4q0bazmy/Listeners TMPDIR=/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:35:58 INFO - MultiFileLogger online at 20160808 05:35:58 in /builds/slave/test 05:35:58 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 05:35:58 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:35:58 INFO - {'append_to_log': False, 05:35:58 INFO - 'base_work_dir': '/builds/slave/test', 05:35:58 INFO - 'blob_upload_branch': 'Firefox', 05:35:58 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:35:58 INFO - 'branch': 'Firefox', 05:35:58 INFO - 'buildbot_json_path': 'buildprops.json', 05:35:58 INFO - 'config_files': ('talos/mac_config.py',), 05:35:58 INFO - 'default_actions': ('clobber', 05:35:58 INFO - 'read-buildbot-config', 05:35:58 INFO - 'download-and-extract', 05:35:58 INFO - 'populate-webroot', 05:35:58 INFO - 'create-virtualenv', 05:35:58 INFO - 'install', 05:35:58 INFO - 'run-tests'), 05:35:58 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:35:58 INFO - 'download_minidump_stackwalk': True, 05:35:58 INFO - 'download_symbols': 'ondemand', 05:35:58 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:35:58 INFO - 'tooltool.py': '/tools/tooltool.py', 05:35:58 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:35:58 INFO - '/tools/misc-python/virtualenv.py')}, 05:35:58 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:35:58 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:35:58 INFO - 'installer_path': 'installer.exe', 05:35:58 INFO - 'log_level': 'info', 05:35:58 INFO - 'log_name': 'talos', 05:35:58 INFO - 'log_to_console': True, 05:35:58 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 05:35:58 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 05:35:58 INFO - 'opt_config_files': (), 05:35:58 INFO - 'pip_index': False, 05:35:58 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:35:58 INFO - 'cmd': ('bash', 05:35:58 INFO - '-c', 05:35:58 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:35:58 INFO - 'enabled': True, 05:35:58 INFO - 'halt_on_failure': False, 05:35:58 INFO - 'name': 'check_screen_resolution'},), 05:35:58 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:35:58 INFO - 'cmd': ('bash', 05:35:58 INFO - '-c', 05:35:58 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:35:58 INFO - 'enabled': True, 05:35:58 INFO - 'halt_on_failure': False, 05:35:58 INFO - 'name': 'check_screen_resolution'},), 05:35:58 INFO - 'run_cmd_checks_enabled': True, 05:35:58 INFO - 'sps_profile': False, 05:35:58 INFO - 'sps_profile_interval': 0, 05:35:58 INFO - 'suite': 'dromaeojs-e10s', 05:35:58 INFO - 'system_bits': '32', 05:35:58 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:35:58 INFO - 'title': 't-yosemite-r7-0172', 05:35:58 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:35:58 INFO - 'use_talos_json': True, 05:35:58 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:35:58 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:35:58 INFO - 'work_dir': 'build'} 05:35:58 INFO - [mozharness: 2016-08-08 12:35:58.637903Z] Running clobber step. 05:35:58 INFO - Running pre-action listener: _resource_record_pre_action 05:35:58 INFO - Running main action method: clobber 05:35:58 INFO - rmtree: /builds/slave/test/build 05:35:58 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:36:00 INFO - Running post-action listener: _resource_record_post_action 05:36:00 INFO - [mozharness: 2016-08-08 12:36:00.716183Z] Finished clobber step (success) 05:36:00 INFO - [mozharness: 2016-08-08 12:36:00.716316Z] Running read-buildbot-config step. 05:36:00 INFO - Running pre-action listener: _resource_record_pre_action 05:36:00 INFO - Running main action method: read_buildbot_config 05:36:00 INFO - Using buildbot properties: 05:36:00 INFO - { 05:36:00 INFO - "project": "", 05:36:00 INFO - "product": "firefox", 05:36:00 INFO - "script_repo_revision": "production", 05:36:00 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs-e10s", 05:36:00 INFO - "repository": "", 05:36:00 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs-e10s", 05:36:00 INFO - "buildid": "20160808030441", 05:36:00 INFO - "stage_platform": "macosx64", 05:36:00 INFO - "basedir": "/builds/slave/test", 05:36:00 INFO - "nightly_build": "True", 05:36:00 INFO - "buildnumber": 32, 05:36:00 INFO - "slavename": "t-yosemite-r7-0172", 05:36:00 INFO - "master": "http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/", 05:36:00 INFO - "platform": "yosemite_r7", 05:36:00 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 05:36:00 INFO - "branch": "mozilla-central", 05:36:00 INFO - "repo_path": "mozilla-central", 05:36:00 INFO - "revision": "e78975b53563d80c99ebfbdf8a9fbf6b829a8a48", 05:36:00 INFO - "pgo_build": "False", 05:36:00 INFO - "builduid": "f603c1cd8c81472499074ffbf994b474", 05:36:00 INFO - "slavebuilddir": "test" 05:36:00 INFO - } 05:36:00 INFO - Found installer url https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg. 05:36:00 INFO - Running post-action listener: _resource_record_post_action 05:36:00 INFO - [mozharness: 2016-08-08 12:36:00.719844Z] Finished read-buildbot-config step (success) 05:36:00 INFO - [mozharness: 2016-08-08 12:36:00.719976Z] Running download-and-extract step. 05:36:00 INFO - Running pre-action listener: _resource_record_pre_action 05:36:00 INFO - Running main action method: download_and_extract 05:36:00 INFO - mkdir: /builds/slave/test/build/tests 05:36:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:00 INFO - trying https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.test_packages.json 05:36:00 INFO - Downloading https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:01 INFO - Downloaded 1199 bytes. 05:36:01 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.mac.test_packages.json 05:36:01 INFO - Using the following test package requirements: 05:36:01 INFO - {u'common': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 05:36:01 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 05:36:01 INFO - u'firefox-51.0a1.en-US.mac.cppunittest.tests.zip'], 05:36:01 INFO - u'gtest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 05:36:01 INFO - u'firefox-51.0a1.en-US.mac.gtest.tests.zip'], 05:36:01 INFO - u'jittest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 05:36:01 INFO - u'jsshell-mac.zip'], 05:36:01 INFO - u'mochitest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 05:36:01 INFO - u'firefox-51.0a1.en-US.mac.mochitest.tests.zip'], 05:36:01 INFO - u'mozbase': [u'firefox-51.0a1.en-US.mac.common.tests.zip'], 05:36:01 INFO - u'reftest': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 05:36:01 INFO - u'firefox-51.0a1.en-US.mac.reftest.tests.zip'], 05:36:01 INFO - u'talos': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 05:36:01 INFO - u'firefox-51.0a1.en-US.mac.talos.tests.zip'], 05:36:01 INFO - u'web-platform': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 05:36:01 INFO - u'firefox-51.0a1.en-US.mac.web-platform.tests.zip'], 05:36:01 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.mac.common.tests.zip', 05:36:01 INFO - u'firefox-51.0a1.en-US.mac.xpcshell.tests.zip']} 05:36:01 INFO - Downloading packages: [u'firefox-51.0a1.en-US.mac.common.tests.zip'] for test suite category: common 05:36:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:01 INFO - trying https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 05:36:01 INFO - Downloading https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:02 INFO - Downloaded 16324347 bytes. 05:36:02 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:36:02 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 05:36:05 INFO - Return code: 0 05:36:05 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 05:36:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:05 INFO - trying https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.common.tests.zip 05:36:05 INFO - Downloading https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:06 INFO - Downloaded 16324347 bytes. 05:36:06 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:36:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 05:36:10 INFO - Return code: 0 05:36: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')]} 05:36:10 INFO - trying https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.talos.tests.zip 05:36:10 INFO - Downloading https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:11 INFO - Downloaded 14413723 bytes. 05:36:11 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:36:11 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 05:36:11 INFO - Return code: 0 05:36:11 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')]} 05:36:11 INFO - trying https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 05:36:11 INFO - Downloading https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a1.en-US.mac.dmg 05:36:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/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 05:36:14 INFO - Downloaded 112013008 bytes. 05:36:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 05:36:14 INFO - mkdir: /builds/slave/test/properties 05:36:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:36:14 INFO - Writing to file /builds/slave/test/properties/build_url 05:36:14 INFO - Contents: 05:36:14 INFO - build_url:https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg 05:36:15 INFO - Running post-action listener: _resource_record_post_action 05:36:15 INFO - Running post-action listener: set_extra_try_arguments 05:36:15 INFO - [mozharness: 2016-08-08 12:36:15.675572Z] Finished download-and-extract step (success) 05:36:15 INFO - [mozharness: 2016-08-08 12:36:15.675744Z] Running populate-webroot step. 05:36:15 INFO - Running pre-action listener: _resource_record_pre_action 05:36:15 INFO - Running main action method: populate_webroot 05:36:15 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:36:15 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:36:15 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:36:15 INFO - '--tppagecycles', 05:36:15 INFO - '7'], 05:36:15 INFO - 'tests': ['tsvgm']}}, 05:36:15 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:36:15 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:36:15 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:36:15 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:36:15 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:36:15 INFO - 'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:36:15 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:36:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:36:15 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:36:15 INFO - 'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['damp', 'tps']}, 05:36:15 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:36:15 INFO - 'tests': ['damp', 'tps']}, 05:36:15 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['dromaeo_dom']}, 05:36:15 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:36:15 INFO - 'g4': {'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['basic_compositor_video']}, 05:36:15 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 05:36:15 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['a11yr', 05:36:15 INFO - 'ts_paint', 05:36:15 INFO - 'tpaint', 05:36:15 INFO - 'sessionrestore', 05:36:15 INFO - 'sessionrestore_no_auto_restore', 05:36:15 INFO - 'tabpaint']}, 05:36:15 INFO - 'other-e10s': {'tests': ['a11yr', 05:36:15 INFO - 'ts_paint', 05:36:15 INFO - 'tpaint', 05:36:15 INFO - 'sessionrestore', 05:36:15 INFO - 'sessionrestore_no_auto_restore', 05:36:15 INFO - 'tabpaint']}, 05:36:15 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:36:15 INFO - 'ts_paint', 05:36:15 INFO - 'tpaint', 05:36:15 INFO - 'sessionrestore', 05:36:15 INFO - 'sessionrestore_no_auto_restore', 05:36:15 INFO - 'tabpaint']}, 05:36:15 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:36:15 INFO - 'ts_paint', 05:36:15 INFO - 'tpaint', 05:36:15 INFO - 'sessionrestore', 05:36:15 INFO - 'sessionrestore_no_auto_restore', 05:36:15 INFO - 'tabpaint']}, 05:36:15 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['a11yr', 05:36:15 INFO - 'ts_paint', 05:36:15 INFO - 'tpaint', 05:36:15 INFO - 'sessionrestore', 05:36:15 INFO - 'sessionrestore_no_auto_restore', 05:36:15 INFO - 'tabpaint']}, 05:36:15 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['a11yr', 05:36:15 INFO - 'ts_paint', 05:36:15 INFO - 'tpaint', 05:36:15 INFO - 'sessionrestore', 05:36:15 INFO - 'sessionrestore_no_auto_restore', 05:36:15 INFO - 'tabpaint']}, 05:36:15 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['tsvgx', 05:36:15 INFO - 'tsvgr_opacity', 05:36:15 INFO - 'tart', 05:36:15 INFO - 'tscrollx', 05:36:15 INFO - 'cart']}, 05:36:15 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:36:15 INFO - 'tsvgr_opacity', 05:36:15 INFO - 'tart', 05:36:15 INFO - 'tscrollx', 05:36:15 INFO - 'cart']}, 05:36:15 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:36:15 INFO - 'talos_options': ['--disable-e10s'], 05:36:15 INFO - 'tests': ['tp5o']}, 05:36:15 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:36:15 INFO - 'tests': ['tp5o']}, 05:36:15 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:36:15 INFO - 'talos_options': ['--disable-e10s', 05:36:15 INFO - '--xperf_path', 05:36:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:36:15 INFO - 'tests': ['tp5n']}, 05:36:15 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:36:15 INFO - 'talos_options': ['--xperf_path', 05:36:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:36:15 INFO - 'tests': ['tp5n']}}, 05:36:15 INFO - 'talos.zip': {'path': '', 05:36:15 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:36:15 INFO - Running post-action listener: _resource_record_post_action 05:36:15 INFO - [mozharness: 2016-08-08 12:36:15.694437Z] Finished populate-webroot step (success) 05:36:15 INFO - [mozharness: 2016-08-08 12:36:15.694545Z] Running create-virtualenv step. 05:36:15 INFO - Running pre-action listener: _resource_record_pre_action 05:36:15 INFO - Running main action method: create_virtualenv 05:36:15 INFO - Creating virtualenv /builds/slave/test/build/venv 05:36:15 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 05:36:15 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:36:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:36:15 INFO - Using real prefix '/tools/python27' 05:36:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:36:16 INFO - Installing distribute.............................................................................................................................................................................................done. 05:36:19 INFO - Installing pip.................done. 05:36:19 INFO - Return code: 0 05:36:19 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:36:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 05:36:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:36:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:19 INFO - 'HOME': '/Users/cltbld', 05:36:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:19 INFO - 'LOGNAME': 'cltbld', 05:36:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:19 INFO - 'MOZ_NO_REMOTE': '1', 05:36:19 INFO - 'NO_EM_RESTART': '1', 05:36:19 INFO - 'PAGER': '/bin/cat', 05:36:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:19 INFO - 'PWD': '/builds/slave/test', 05:36:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:19 INFO - 'SHELL': '/bin/bash', 05:36:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:19 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:19 INFO - 'USER': 'cltbld', 05:36:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:19 INFO - 'XPC_FLAGS': '0x0', 05:36:19 INFO - 'XPC_SERVICE_NAME': '0', 05:36:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 05:36:19 INFO - Cleaning up... 05:36:19 INFO - Return code: 0 05:36:19 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:36:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 05:36:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 05:36:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:19 INFO - 'HOME': '/Users/cltbld', 05:36:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:19 INFO - 'LOGNAME': 'cltbld', 05:36:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:19 INFO - 'MOZ_NO_REMOTE': '1', 05:36:19 INFO - 'NO_EM_RESTART': '1', 05:36:19 INFO - 'PAGER': '/bin/cat', 05:36:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:19 INFO - 'PWD': '/builds/slave/test', 05:36:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:19 INFO - 'SHELL': '/bin/bash', 05:36:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:19 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:19 INFO - 'USER': 'cltbld', 05:36:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:19 INFO - 'XPC_FLAGS': '0x0', 05:36:19 INFO - 'XPC_SERVICE_NAME': '0', 05:36:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:19 INFO - Downloading/unpacking psutil>=3.1.1 05:36:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:36:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:36:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:36:23 INFO - Installing collected packages: psutil 05:36:23 INFO - Running setup.py install for psutil 05:36:24 INFO - building 'psutil._psutil_osx' extension 05:36:24 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 05:36:24 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 05:36:24 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 05:36:24 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 05:36:24 INFO - building 'psutil._psutil_posix' extension 05:36:24 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 05:36:24 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 05:36:24 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 05:36:24 INFO - ^ 05:36:25 INFO - 1 warning generated. 05:36:25 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 05:36:25 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:36:25 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:36:25 INFO - Successfully installed psutil 05:36:25 INFO - Cleaning up... 05:36:25 INFO - Return code: 0 05:36:25 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:36:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 05:36:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 05:36:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:25 INFO - 'HOME': '/Users/cltbld', 05:36:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:25 INFO - 'LOGNAME': 'cltbld', 05:36:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:25 INFO - 'MOZ_NO_REMOTE': '1', 05:36:25 INFO - 'NO_EM_RESTART': '1', 05:36:25 INFO - 'PAGER': '/bin/cat', 05:36:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:25 INFO - 'PWD': '/builds/slave/test', 05:36:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:25 INFO - 'SHELL': '/bin/bash', 05:36:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:25 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:25 INFO - 'USER': 'cltbld', 05:36:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:25 INFO - 'XPC_FLAGS': '0x0', 05:36:25 INFO - 'XPC_SERVICE_NAME': '0', 05:36:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:25 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:36: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 05:36: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 05:36: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 05:36: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 05:36: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 05:36: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 05:36:28 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:36:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:36:28 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:36:28 INFO - Installing collected packages: mozsystemmonitor 05:36:28 INFO - Running setup.py install for mozsystemmonitor 05:36:28 INFO - Successfully installed mozsystemmonitor 05:36:28 INFO - Cleaning up... 05:36:28 INFO - Return code: 0 05:36:28 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:36: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')]} 05:36:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36: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')]} 05:36:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 05:36:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 05:36:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:28 INFO - 'HOME': '/Users/cltbld', 05:36:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:28 INFO - 'LOGNAME': 'cltbld', 05:36:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:28 INFO - 'MOZ_NO_REMOTE': '1', 05:36:28 INFO - 'NO_EM_RESTART': '1', 05:36:28 INFO - 'PAGER': '/bin/cat', 05:36:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:28 INFO - 'PWD': '/builds/slave/test', 05:36:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:28 INFO - 'SHELL': '/bin/bash', 05:36:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:28 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:28 INFO - 'USER': 'cltbld', 05:36:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:28 INFO - 'XPC_FLAGS': '0x0', 05:36:28 INFO - 'XPC_SERVICE_NAME': '0', 05:36:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:28 INFO - Downloading/unpacking jsonschema==2.5.1 05:36:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:31 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:36:31 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:36:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:31 INFO - Downloading functools32-3.2.3-2.tar.gz 05:36:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:36:31 INFO - warning: no files found matching '*.txt' 05:36:31 INFO - no previously-included directories found matching 'build' 05:36:31 INFO - no previously-included directories found matching 'dist' 05:36:31 INFO - no previously-included directories found matching '.git*' 05:36:31 INFO - Installing collected packages: jsonschema, functools32 05:36:31 INFO - Running setup.py install for functools32 05:36:32 INFO - warning: no files found matching '*.txt' 05:36:32 INFO - no previously-included directories found matching 'build' 05:36:32 INFO - no previously-included directories found matching 'dist' 05:36:32 INFO - no previously-included directories found matching '.git*' 05:36:32 INFO - Successfully installed jsonschema functools32 05:36:32 INFO - Cleaning up... 05:36:32 INFO - Return code: 0 05:36:32 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 05:36:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:32 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 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:32 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 05:36:32 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 05:36:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:32 INFO - 'HOME': '/Users/cltbld', 05:36:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:32 INFO - 'LOGNAME': 'cltbld', 05:36:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:32 INFO - 'MOZ_NO_REMOTE': '1', 05:36:32 INFO - 'NO_EM_RESTART': '1', 05:36:32 INFO - 'PAGER': '/bin/cat', 05:36:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:32 INFO - 'PWD': '/builds/slave/test', 05:36:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:32 INFO - 'SHELL': '/bin/bash', 05:36:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:32 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:32 INFO - 'USER': 'cltbld', 05:36:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:32 INFO - 'XPC_FLAGS': '0x0', 05:36:32 INFO - 'XPC_SERVICE_NAME': '0', 05:36:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:32 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 05:36:32 INFO - Cleaning up... 05:36:32 INFO - Return code: 0 05:36:32 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:36:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:32 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 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:32 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 05:36:32 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 05:36:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:32 INFO - 'HOME': '/Users/cltbld', 05:36:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:32 INFO - 'LOGNAME': 'cltbld', 05:36:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:32 INFO - 'MOZ_NO_REMOTE': '1', 05:36:32 INFO - 'NO_EM_RESTART': '1', 05:36:32 INFO - 'PAGER': '/bin/cat', 05:36:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:32 INFO - 'PWD': '/builds/slave/test', 05:36:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:32 INFO - 'SHELL': '/bin/bash', 05:36:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:32 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:32 INFO - 'USER': 'cltbld', 05:36:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:32 INFO - 'XPC_FLAGS': '0x0', 05:36:32 INFO - 'XPC_SERVICE_NAME': '0', 05:36:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:32 INFO - Downloading/unpacking blobuploader==1.2.4 05:36:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:36:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:36:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:36:35 INFO - Downloading blobuploader-1.2.4.tar.gz 05:36:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:36:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:36:35 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 05:36:35 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 05:36:35 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 05:36:35 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 05:36:35 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 05:36:35 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 05:36:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:36:35 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:36:35 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 05:36:35 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 05:36:35 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 05:36:35 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 05:36:35 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 05:36:35 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 05:36:36 INFO - Downloading docopt-0.6.1.tar.gz 05:36:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:36:36 INFO - Installing collected packages: blobuploader, requests, docopt 05:36:36 INFO - Running setup.py install for blobuploader 05:36:36 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:36:36 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:36:36 INFO - Running setup.py install for requests 05:36:37 INFO - Running setup.py install for docopt 05:36:37 INFO - Successfully installed blobuploader requests docopt 05:36:37 INFO - Cleaning up... 05:36:37 INFO - Return code: 0 05:36:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:36:37 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')]} 05:36:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:37 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')]} 05:36:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:37 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 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:37 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 05:36:37 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 05:36:37 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:37 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:37 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:37 INFO - 'HOME': '/Users/cltbld', 05:36:37 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:37 INFO - 'LOGNAME': 'cltbld', 05:36:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:37 INFO - 'MOZ_NO_REMOTE': '1', 05:36:37 INFO - 'NO_EM_RESTART': '1', 05:36:37 INFO - 'PAGER': '/bin/cat', 05:36:37 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:37 INFO - 'PWD': '/builds/slave/test', 05:36:37 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:37 INFO - 'SHELL': '/bin/bash', 05:36:37 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:37 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:37 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:37 INFO - 'USER': 'cltbld', 05:36:37 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:37 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:37 INFO - 'XPC_FLAGS': '0x0', 05:36:37 INFO - 'XPC_SERVICE_NAME': '0', 05:36:37 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:36:37 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-oa5OEx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:36:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:36:37 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-YvCtXo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:36:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:36:37 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-GU3Mpl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:36:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:36:37 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-a07oQ2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:36:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-YhcJpC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-OVmXiW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-_PGfAl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-Xi32Aq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-OdakeG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-zxj8Xz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-j2PV_2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-cdSZg5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-yA488K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:36:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:36:38 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-F1LqaJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:36:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:36:39 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-3GK8GS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:36:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:36:39 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-tLpwaQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:36:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:36:39 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-DSAXT_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:36:39 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:36:39 INFO - Running setup.py install for manifestparser 05:36:39 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:36:39 INFO - Running setup.py install for mozcrash 05:36:39 INFO - Running setup.py install for mozdebug 05:36:39 INFO - Running setup.py install for mozdevice 05:36:39 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:36:39 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:36:39 INFO - Running setup.py install for mozfile 05:36:40 INFO - Running setup.py install for mozhttpd 05:36:40 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:36:40 INFO - Running setup.py install for mozinfo 05:36:40 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:36:40 INFO - Running setup.py install for mozInstall 05:36:40 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:36:40 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:36:40 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:36:40 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:36:40 INFO - Running setup.py install for mozleak 05:36:40 INFO - Running setup.py install for mozlog 05:36:40 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:36:40 INFO - Running setup.py install for moznetwork 05:36:40 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:36:40 INFO - Running setup.py install for mozprocess 05:36:41 INFO - Running setup.py install for mozprofile 05:36:41 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:36:41 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:36:41 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:36:41 INFO - Running setup.py install for mozrunner 05:36:41 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:36:41 INFO - Running setup.py install for mozscreenshot 05:36:41 INFO - Running setup.py install for moztest 05:36:41 INFO - Running setup.py install for mozversion 05:36:41 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:36:41 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:36:41 INFO - Cleaning up... 05:36:41 INFO - Return code: 0 05:36:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:36:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:36:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:41 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 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:41 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 05:36:41 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 05:36:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:41 INFO - 'HOME': '/Users/cltbld', 05:36:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:41 INFO - 'LOGNAME': 'cltbld', 05:36:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:41 INFO - 'MOZ_NO_REMOTE': '1', 05:36:41 INFO - 'NO_EM_RESTART': '1', 05:36:41 INFO - 'PAGER': '/bin/cat', 05:36:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:41 INFO - 'PWD': '/builds/slave/test', 05:36:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:41 INFO - 'SHELL': '/bin/bash', 05:36:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:41 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:41 INFO - 'USER': 'cltbld', 05:36:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:41 INFO - 'XPC_FLAGS': '0x0', 05:36:41 INFO - 'XPC_SERVICE_NAME': '0', 05:36:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:36:42 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-FemfpL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:36:42 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)) 05:36:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:36:42 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-HjUlaJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:36:42 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)) 05:36:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:36:42 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-H617pr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:36:42 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)) 05:36:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:36:42 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-WQkiqj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:36:42 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)) 05:36:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:36:42 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-STFQBR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:36:42 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)) 05:36:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:36:42 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-LV_6cl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:36:42 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)) 05:36:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:36:42 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-i_wPbu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:36:42 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)) 05:36:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:36:42 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-aw8uc0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-KhoFWN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-Ca0HME-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-VMsMFR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-Q6Nn08-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-NS2Z6O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-6UMHAK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-RyhyJq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-iOtNQV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:36:43 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)) 05:36:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:36:43 INFO - Running setup.py (path:/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/pip-CRPsWU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:36:43 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)) 05:36:43 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)) 05:36:43 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)) 05:36:43 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)) 05:36:43 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)) 05:36:43 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)) 05:36:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:36:43 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 05:36:43 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 05:36:43 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 05:36:43 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 05:36:43 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 05:36:43 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 05:36:46 INFO - Downloading blessings-1.6.tar.gz 05:36:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:36:46 INFO - Installing collected packages: blessings 05:36:46 INFO - Running setup.py install for blessings 05:36:46 INFO - Successfully installed blessings 05:36:46 INFO - Cleaning up... 05:36:46 INFO - Return code: 0 05:36:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:36:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:36:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:36:47 INFO - Reading from file tmpfile_stdout 05:36:47 INFO - Current package versions: 05:36:47 INFO - blessings == 1.6 05:36:47 INFO - blobuploader == 1.2.4 05:36:47 INFO - docopt == 0.6.1 05:36:47 INFO - functools32 == 3.2.3-2 05:36:47 INFO - jsonschema == 2.5.1 05:36:47 INFO - manifestparser == 1.1 05:36:47 INFO - mozInstall == 1.12 05:36:47 INFO - mozcrash == 0.17 05:36:47 INFO - mozdebug == 0.1 05:36:47 INFO - mozdevice == 0.48 05:36:47 INFO - mozfile == 1.2 05:36:47 INFO - mozhttpd == 0.7 05:36:47 INFO - mozinfo == 0.9 05:36:47 INFO - mozleak == 0.1 05:36:47 INFO - mozlog == 3.3 05:36:47 INFO - moznetwork == 0.27 05:36:47 INFO - mozprocess == 0.23 05:36:47 INFO - mozprofile == 0.28 05:36:47 INFO - mozrunner == 6.12 05:36:47 INFO - mozscreenshot == 0.1 05:36:47 INFO - mozsystemmonitor == 0.3 05:36:47 INFO - moztest == 0.7 05:36:47 INFO - mozversion == 1.4 05:36:47 INFO - psutil == 3.1.1 05:36:47 INFO - requests == 1.2.3 05:36:47 INFO - wsgiref == 0.1.2 05:36:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:36: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')]} 05:36:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36: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')]} 05:36:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:47 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 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:47 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 05:36:47 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 05:36:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:47 INFO - 'HOME': '/Users/cltbld', 05:36:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:47 INFO - 'LOGNAME': 'cltbld', 05:36:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:47 INFO - 'MOZ_NO_REMOTE': '1', 05:36:47 INFO - 'NO_EM_RESTART': '1', 05:36:47 INFO - 'PAGER': '/bin/cat', 05:36:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:47 INFO - 'PWD': '/builds/slave/test', 05:36:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:47 INFO - 'SHELL': '/bin/bash', 05:36:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:47 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:47 INFO - 'USER': 'cltbld', 05:36:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:47 INFO - 'XPC_FLAGS': '0x0', 05:36:47 INFO - 'XPC_SERVICE_NAME': '0', 05:36:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 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)) 05:36:47 INFO - Cleaning up... 05:36:47 INFO - Return code: 0 05:36:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:36: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')]} 05:36:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:36:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36: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')]} 05:36:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:36:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:36:47 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 0x10ac6ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ad03618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcea8495fe0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, '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.24v1Ola66r/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.UB4q0bazmy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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 05:36:47 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 05:36:47 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 05:36:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:36:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:36:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:36:47 INFO - 'HOME': '/Users/cltbld', 05:36:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:36:47 INFO - 'LOGNAME': 'cltbld', 05:36:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:36:47 INFO - 'MOZ_NO_REMOTE': '1', 05:36:47 INFO - 'NO_EM_RESTART': '1', 05:36:47 INFO - 'PAGER': '/bin/cat', 05:36:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:36:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:36:47 INFO - 'PWD': '/builds/slave/test', 05:36:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:36:47 INFO - 'SHELL': '/bin/bash', 05:36:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:36:47 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:36:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:36:47 INFO - 'USER': 'cltbld', 05:36:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:36:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:36:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:36:47 INFO - 'XPC_FLAGS': '0x0', 05:36:47 INFO - 'XPC_SERVICE_NAME': '0', 05:36:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:36:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:36:47 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:36:47 INFO - Cleaning up... 05:36:47 INFO - Return code: 0 05:36:47 INFO - Running post-action listener: _resource_record_post_action 05:36:47 INFO - Running post-action listener: _start_resource_monitoring 05:36:47 INFO - Starting resource monitoring. 05:36:47 INFO - [mozharness: 2016-08-08 12:36:47.658756Z] Finished create-virtualenv step (success) 05:36:47 INFO - [mozharness: 2016-08-08 12:36:47.659699Z] Running install step. 05:36:47 INFO - Running pre-action listener: _resource_record_pre_action 05:36:47 INFO - Running main action method: install 05:36:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:36:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:36:47 INFO - Reading from file tmpfile_stdout 05:36:47 INFO - Detecting whether we're running mozinstall >=1.0... 05:36:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:36:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:36:48 INFO - Reading from file tmpfile_stdout 05:36:48 INFO - Output received: 05:36:48 INFO - Usage: mozinstall [options] installer 05:36:48 INFO - Options: 05:36:48 INFO - -h, --help show this help message and exit 05:36:48 INFO - -d DEST, --destination=DEST 05:36:48 INFO - Directory to install application into. [default: 05:36:48 INFO - "/builds/slave/test"] 05:36:48 INFO - --app=APP Application being installed. [default: firefox] 05:36:48 INFO - mkdir: /builds/slave/test/build/application 05:36:48 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'] 05:36:48 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 05:37:23 INFO - Reading from file tmpfile_stdout 05:37:23 INFO - Output received: 05:37:23 INFO - /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox 05:37:23 INFO - Running post-action listener: _resource_record_post_action 05:37:23 INFO - [mozharness: 2016-08-08 12:37:23.223279Z] Finished install step (success) 05:37:23 INFO - [mozharness: 2016-08-08 12:37:23.223424Z] Running run-tests step. 05:37:23 INFO - Running pre-action listener: _resource_record_pre_action 05:37:23 INFO - Running main action method: run_tests 05:37:23 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:37:23 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:37:23 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:37:23 INFO - 2016-08-08 05:37:23.237 screenresolution[1645:7578] starting screenresolution argv=screenresolution get 05:37:23 INFO - 2016-08-08 05:37:23.240 screenresolution[1645:7578] Display 0: 1600x1200x32@60 05:37:23 INFO - 2016-08-08 05:37:23.245 screenresolution[1646:7580] starting screenresolution argv=screenresolution list 05:37:23 INFO - Available Modes on Display 0 05:37:23 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:37:23 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:37:23 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:37:23 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:37:23 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:37:23 INFO - Intel Iris: 05:37:23 INFO - Chipset Model: Intel Iris 05:37:23 INFO - Type: GPU 05:37:23 INFO - Bus: Built-In 05:37:23 INFO - VRAM (Dynamic, Max): 1536 MB 05:37:23 INFO - Vendor: Intel (0x8086) 05:37:23 INFO - Device ID: 0x0a2e 05:37:23 INFO - Revision ID: 0x0009 05:37:23 INFO - Displays: 05:37:23 INFO - Display: 05:37:23 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:37:23 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:37:23 INFO - Display Serial Number: 1600x1200 60 05:37:23 INFO - Main Display: Yes 05:37:23 INFO - Mirror: Off 05:37:23 INFO - Online: Yes 05:37:23 INFO - Rotation: Supported 05:37:23 INFO - Return code: 0 05:37:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:37:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:37:23 INFO - Python 2.7.3 05:37:23 INFO - Return code: 0 05:37:23 INFO - grabbing minidump binary from tooltool 05:37: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')]} 05:37:23 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 0x10abd2d30>, '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 0x10a937db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10abcab20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:37:23 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 05:37:23 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 05:37:23 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 05:37:23 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:37:23 INFO - Return code: 0 05:37:23 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 05:37:23 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:37:23 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:37:23 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 05:37:23 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:37:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0172', '--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 05:37:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0172 --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 05:37:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.24v1Ola66r/Render', 05:37:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:37:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:37:23 INFO - 'HOME': '/Users/cltbld', 05:37:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:37:23 INFO - 'LOGNAME': 'cltbld', 05:37:23 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:37:23 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 05:37:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:23 INFO - 'MOZ_NO_REMOTE': '1', 05:37:23 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:37:23 INFO - 'NO_EM_RESTART': '1', 05:37:23 INFO - 'PAGER': '/bin/cat', 05:37:23 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:37:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:37:23 INFO - 'PWD': '/builds/slave/test', 05:37:23 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:37:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:37:23 INFO - 'SHELL': '/bin/bash', 05:37:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UB4q0bazmy/Listeners', 05:37:23 INFO - 'TMPDIR': '/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/', 05:37:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:37:23 INFO - 'USER': 'cltbld', 05:37:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:37:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:37:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:23 INFO - 'XPC_FLAGS': '0x0', 05:37:23 INFO - 'XPC_SERVICE_NAME': '0', 05:37:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:37:23 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0172', '--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 05:37:23 INFO - mozversion application_buildid: 20160808030441 05:37:23 INFO - mozversion application_changeset: e78975b53563d80c99ebfbdf8a9fbf6b829a8a48 05:37:23 INFO - mozversion application_display_name: Nightly 05:37:23 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:37:23 INFO - mozversion application_name: Firefox 05:37:23 INFO - mozversion application_remotingname: firefox 05:37:23 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 05:37:23 INFO - mozversion application_vendor: Mozilla 05:37:23 INFO - mozversion application_version: 51.0a1 05:37:23 INFO - mozversion platform_buildid: 20160808030441 05:37:23 INFO - mozversion platform_changeset: e78975b53563d80c99ebfbdf8a9fbf6b829a8a48 05:37:23 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 05:37:23 INFO - mozversion platform_version: 51.0a1 05:37:23 INFO - using testdate: 1470659843 05:37:23 INFO - actual date: 1470659843 05:37:23 INFO - starting webserver on 'localhost:49279' 05:37:23 INFO - SUITE-START | Running 2 tests 05:37:23 INFO - TEST-START | dromaeo_css 05:37:23 INFO - operating with platform_type : mac_ 05:37:23 INFO - Initialising browser for dromaeo_css test... 05:37:23 INFO - TEST-INFO | started process 1656 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/tmpVxKIat/profile http://localhost:49279/getInfo.html) 05:37:26 INFO - PROCESS | 1656 | __metrics Screen width/height:1600/1200 05:37:26 INFO - PROCESS | 1656 | colorDepth:24 05:37:26 INFO - PROCESS | 1656 | Browser inner width/height: 1024/689 05:37:26 INFO - PROCESS | 1656 | __metrics 05:37:26 ERROR - PROCESS | 1656 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 05:37:27 INFO - TEST-INFO | 1656: exit 0 05:37:27 INFO - Browser initialized. 05:37:27 INFO - Running cycle 1/1 for dromaeo_css test... 05:37:27 INFO - TEST-INFO | started process 1660 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/tmpVxKIat/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:37:39 INFO - PROCESS | 1660 | RSS: Main: 254799872 05:37:39 INFO - PROCESS | 1660 | 05:38:29 INFO - PROCESS | 1660 | 1470659909265 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] 05:40:42 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49279/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49279/tests/dromaeo/cssquery-ext.html) 05:40:43 INFO - PROCESS | 1660 | RSS: Main: 267964416 05:40:43 INFO - PROCESS | 1660 | 05:43:46 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49279/tests/dromaeo/cssquery-ext.html (next: http://localhost:49279/tests/dromaeo/cssquery-jquery.html) 05:43:46 INFO - PROCESS | 1660 | RSS: Main: 280211456 05:43:46 INFO - PROCESS | 1660 | 05:46:48 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49279/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49279/tests/dromaeo/cssquery-mootools.html) 05:46:49 INFO - PROCESS | 1660 | RSS: Main: 287756288 05:46:49 INFO - PROCESS | 1660 | 05:49:51 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49279/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49279/tests/dromaeo/cssquery-prototype.html) 05:49:51 INFO - PROCESS | 1660 | RSS: Main: 287240192 05:49:51 INFO - PROCESS | 1660 | 05:52:54 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49279/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49279/tests/dromaeo/cssquery-yui.html) 05:52:55 INFO - PROCESS | 1660 | RSS: Main: 292171776 05:52:55 INFO - PROCESS | 1660 | 05:55:57 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49279/tests/dromaeo/cssquery-yui.html (next: http://localhost:49279/tests/dromaeo/cssquery-dojo.html) 05:55:58 INFO - PROCESS | 1660 | RSS: Main: 292319232 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - PROCESS | 1660 | __start_tp_report 05:55:58 INFO - PROCESS | 1660 | _x_x_mozilla_page_load 05:55:58 INFO - PROCESS | 1660 | _x_x_mozilla_page_load_details 05:55:58 INFO - PROCESS | 1660 | |i|pagename|runs| 05:55:58 INFO - PROCESS | 1660 | |0;dojo.html;3420.5724284464436;3431.845566949487;3472.236108056227;3481.825908704564;3494.8077855717925;5810.418958104187;5822.126680997852;5881.55888308377;5925.5555833312455;5942.346341902387;5693.975084484791;5861.238039054917;5888.852778680535;5936.554758393117;5941.792037278696;5245.580353571724;5280.630355875091;5388.353397592295;5392.245085688007;5437.13005919053;5332.786688532454;5398.865028374303;5471.23402723619;5499.422560631137;5506.972465137689;4382.6055654991205;5270.631055826094;5298.602604804655;5385.946140538623;5410.8917821643545;4240.787960601989;5364.302640656729;5380.058489764315;5387.81142660005;5431.945680543184;4498.212812757754;5304.814331498379;5316.813911513079;5352.57179425645;5359.598030147716;4741.715497070187;5745.48290653839;5758.539316854683;5852.76588936442;6002.369751176151;6223.96888015557;6262.843428914268;6303.5272354573135;6316.557840951135;6338;6382.585131966453;6386.744530218785;6405.903911441332;6413.647249401281;6417.582857114273;5931.9703401483575;6025.3372129065765;6032.788852390146;6064.211652485193;6081.939180608138;6491.383318584727;6501.349865013461;6501.609903405811;6510.609363438209;6514.6416947068365;6166.167567378437;6301.495880329563;6303.590266632654;6312.400321969406;6324.988001919671;6211.565190436717;6262.091996660459;6277.497800175975;6372.2353317601255;6402.6158430494315;6218.19163508741;6227.688615569294;6285.748570057238;6286.402791734778;6292.622442653455;6232.781852635227;6258.624482531062;6292.119103325538;6303.968480157661;6314.589551679218;5059.443461219263;5063.518965698253;5108.438071812097;5127.769250383742;5130.51260130287;4543.750093744809;4557.635389168859;4561;4576.931346029813;4656;5966.313873904556;6052.485538729169;6058.454739073504;6067.302260240041;6092.299385570627;6310.368963103653;6347.333529979378;6351.682415879188;6357.205349331333;6370.617762934239;5824.446677565625;5952.7321270542925;5961.552883533753;6032.517398608101;6109.480694140959;5587;5593.8321850344555;5603.215549823028;5606.271184746039;5610.971945140248;6465.062565927914;6538.117354157128;6547.508936829757;6548.8035358939305;6555.082288479522;6175.69121543912;6298.244210694746;6298.811035668754;6325.019621958604;6401.199850018747;6563.278039415565;6568.1789776277965;6601.768938087144;6606.405423511907;6620.470362371095;6327.11420401135;6345.682715864281;6347.174867267226;6348;6353.745850166127;6229.53278504123;6304.873902522016;6323.588966717149;6355.745770169141;6391.8721625566295;5292.4442933492965;5980.803839232084;6193.876122477615;6259.998400255937;6268;6218.236769788745;6229.034499652561;6273.247210334789;6293;6315.463185629089;5898.203742494708;6074.635521868702;6146.262448506029;6159.969200153971;6233.438990490878;6255.374462553708;6257.061440783918;6258.780942666985;6295.874082518232;6301.086342480223;6011.338752737108;6210.378962103753;6224.9377506224355;6226.408491193511;6247.281562620356 05:55:58 INFO - PROCESS | 1660 | |1;ext.html;445.43652279865955;490.6663468841188;507.1100219115452;543.8531596468956;554.9511423409756;30648.693513064864;40585;40612.390814137776;40629.59370406295;40661.186776264454;40044.99999999993;40626.390604140965;40790.592094079126;41055.97360065993;41357;8339.416240863142;9602.663906763282;9784.36401633895;9801.558929848139;9815.50922453878;9568.138867501924;9602.279829012852;9617.326787124905;9661.758456038586;9685.806283874319;9696.660616878411;9753.756156096084;9754.414735115915;9765.218782497383;9767.75580610487;8131.878021829677;9612.990635983226;9736.805263894683;9755.414675119515;9758.316917815755;9628.807423851484;9673.70978870635;9702.417854928726;9726.90273097267;9732.708018759378;39173;39340.803295983336;39432;39515.60484395177;39518;2810.325521874756;3259.788113772621;3287.4411350070304;3296.8186749728757;3469.479578063311;28821.711782882114;30251.697483025328;30278.09165725032;30623.234419139477;31338.37323253522;3098.690130986906;3101.1936896407096;3110.5956225690516;3133.6396314423678;3198.184462961953;417000.91499542614;447769;451119;451776;453071.9999999967;33359.49960750591;33381.499277510855;33526.66473335236;33572.160695982304;33599.328013440085;33791.324173516885;34546.309073818884;34680.479792803126;34770.82614586911;35457.46813797795;15876.52370428889;16152.353905843634;16399;16462.670746585;16464;12392;12513.186642868184;12611.74776504483;12641.494340226289;12663.176893502077;18778.812211877706;19222;19274.32539861126;19285.035748212533;19343.032848357525;6955.582665040114;7963.562004089715;8146.511209327341;8156.306713929383;8235.8352832943;866.4931015356087;903.4579252448478;994.9850752238722;1018.7198520406947;1172.0799172649429;24548.263552093467;29716.40567188644;30223.942162024225;30735;30897.07308780695;997.3168379659957;1030.3817709374316;1081.9188560857967;1092.7759809239087;1120.5181771838188;13898.58304250874;14655.34050967709;15564.68870622604;15704.607384815243;16059.598510037109;706204;712373;712580;712692;713483;58992.11511827326;59411.40588594145;59995.70002150049;59998.100028499604;60059.69970150121;1325.966850828737;1358.035794585855;1389.3470069067523;1389.9166050037031;1392.1716578635696;27929.58105628458;29077.418451630427;29675.703242967294;30140.397192056476;30283.848580757836;50462.99074018426;51159;51189.48810511996;51263.97472050613;51309.23036154386;640755;643479;650400;654495;655152;22307.77692223122;22724;26538.469230614894;26940.19179424542;27368.58947115755;47154.764226178646;47433.762831185624;47576.04847903092;48909.2663610039;49248.50751492583;40031.1993760129;40212;40906.590934091466;41045.97385065397;41587.584124159584;39763.60236397599;40641.6264576791;40681.38977915274;40757.388639171026;41072.79463602663;37236.06909827276;37729.05677357978;38483;38548.036299092746;38837.41743873787;34037.48943765796;34827;35568.93293201208;35579.82210088933;35662;23941.922613482086;24803.883825227545;25420;25661;26514.602280965417 05:55:58 INFO - PROCESS | 1660 | |2;jquery.html;320.95988001499813;362.9909252268695;376.3958846052086;389.5072732992766;399.06419446398206;20385.28651497198;20409.48976275594;21332.36002919915;21528;21772;20723.171073157057;21122.366329010118;21417.892910535425;21591.1363545458;21670.133194672235;5008.424031236418;5954.732037058343;5963.970180149093;6028.3067447243475;6083.148359229689;5832.154337621064;5843.737031833556;5845.3862344453855;5845.415458454142;5960.88078238435;5685.1756495308155;5806.1000544915605;5859.970700146515;5923.911141332884;5926.436988486087;5766.250387449605;5775.884482310373;5917.4378434048485;5920.348761636238;5935.258092738408;5050.4697006814495;5329.520343169133;5395.865103372408;5425.538829199523;5455.290812194389;13362.799558006638;13434.596962091153;13675.837553807838;13726.176429414267;23536.88231558831;2305.965410518844;2352.306069709423;2530.607755797854;3015.547667849818;3015.6833532479213;13855.376508057161;15171.089734615958;16363.281855405248;17171.656566868718;17958.820411795845;1905.247427266222;1930.6138772245467;1963.4796778853615;2020.2424090965887;2039.857209995301;88731.55634221788;110722.44638776834;116446.41776791147;143833;148639;21379.572408551743;21944.89027554852;22074.558508829734;22159.667604985938;22286.997085131206;35352.46971295433;35403;35419.4687079694;35599;35601.8219908904;10270.229732770073;10673.893261067446;10928.945355273172;11071.391073491035;11150.60972865962;7465.7013719450615;8412.369072319478;9030.909690903138;9092.27261819053;9104.362694611315;9862.408255504693;9899;9906.455144967096;9909.067731792375;9997.350172238781;3316.800991940443;3789.3558095123894;3899.6880249579967;3960.742551734128;3961.3859851723028;860.9009963854112;900.3562452846246;928.2388441478058;944.2163004706077;990.7869807991317;15282.470921747077;21134.943252837296;21360;21425.357239282846;21528.677069843965;851.6295411496019;958.7219706285099;1017.2574020964737;1027.8612387327764;1036.3212096077082;9475.241980641533;10643.574257029632;11263.26788758728;11372.545098196146;11422.543098276143;226299.60550591754;506333;606976;611165;613164;88906;128830;130578.34710826575;132081;135840.32079839538;949.1220620925754;957.0238356875948;965.0205041882494;974.8001659659894;979.1823827104305;18759.906200469457;18983.90508047451;19552.706709399656;20039.899800500905;20046.599068018848;51666.45000649836;53246.73376633092;53345.733271333396;54006.729966349914;54912;79275;80546.19453805621;81387;81412;84626.57686711774;7230.927690723025;7921.445498815258;8143.59282035884;8231.218034286732;8378.748637540884;9378.01530839252;12455.065870059601;13042.217466952014;13243.66890827737;13594.252316122709;11253.831192532283;11354.886451135713;11420.600278990196;11683.474243659226;11705.180637355303;9327.720168394959;9555.808883822423;11250.437478126225;11328.03711684516;11515.481803318704;11565.479553420284;11708.824367634663;11891.821622675494;11895.286282823059;11917.284962902253;7122.786316410516;8015.559144247122;8028.197180281925;8215.178482151738;8456.915430845858;11062.557497700001;11286.266392684449;11509.424528773361;11547.711307217387;11629.302241865515 05:55:58 INFO - PROCESS | 1660 | |3;mootools.html;1543.8456154384562;1570.07365654264;1767.6818172728904;1828.4788835181976;1892.1674463236166;6978;7263.745768898089;7976.48152870063;9020.233280171185;9048.321375896801;8653.826923461544;8857.42426742263;8863.157999990006;8876.8668469973;8896.688615898445;1969.8916559589218;2327.4530485335977;2352.517733864562;2362.090595120874;2364.125273648752;1981.2273213446767;2338.929832105031;2377.524495100978;2409.4819613783034;2410.650455683925;2365.195833416638;2371.5849726297915;2380.4048987753063;2397.2688330059327;2407.422218667516;1945.5816999345068;2259.830512711545;2278.6809846621486;2279.5782780185637;2285.5771682238674;2365.5978483657645;2370.454795397051;2371.549405612945;2376.310869847742;2385.928422147321;8933.240674542672;8978.775530611721;8987.191152796215;8990.235829954461;9012.504312262823;5219.060569097561;5278.683279003272;5300.946990530084;5377.8117765878005;5379.946200538023;3362.562866827321;3449.3273811606746;3538.486919396673;3539.4513850353237;3603.1172362771026;1097.7255686078481;1112.8497652816848;1788.4902802701167;1857.5077604434834;1906.5233691577105;11096.05683516902;11264.21150519464;11419.714507137305;11579.826302605468;11692;4681.976590117096;4786.2581299898575;4790.281457781361;4894.657373983787;4895.167821470359;10130.290879638354;10151.390916545031;10154.492275386201;10154.746131346776;10163.898361016443;5359.981603495401;5372.3016007919505;5381.381141168816;5394.433584473652;5411.242426060355;4405.867823965286;4734.19518681818;4850.175470170079;4874.658773885794;4914.680545764514;3923.588023257574;3947.9013024674036;4042.5755295694116;4092.3656833190903;4098;1115.570505355444;1287.5557932513268;1300.596814987357;1301.3688361144837;1308.3262120008203;919.2599957034518;923.6628630549935;945.4610871803006;948.2556193388157;999.8050380175941;4705.529447055335;5964.314103878023;6009.369016253318;6028.517718582503;6141.692915354214;438.9890252743707;440.11536811010103;442.81401811239357;449.3641497281376;449.67398635988644;3915.8629447969183;4010.879673609738;4158.126793373365;4169.0411205422315;4181.017460896687;10441.84337234942;10593.947030264799;10795.460226988776;10872.836907446395;10927.726806829893;10540.631077912236;10671.359718416765;10713.625023124154;10787.029167374974;10884.564617415215;8095.23095305945;8146.30756385702;8329.750107496906;8342.332613391036;8349.123342049119;5844.6785426801935;5934.525237981037;5997.640141591519;6037.15479832815;6046.637201767908;8365.33077353798;9997.900020999698;10118.875036242178;10121.937196594547;10152.593896244067;7963.920360796318;10041.246906481896;10047.095761381219;10212.744681383025;10239.795204096024;6109.908351374822;7009.12385951756;7397.075365579302;7528.473006889465;7696.230376962259;7352.154502232098;8343.249107580104;8349.666013359398;8399.41204115706;8420.87368689458;7507;7597.848043038997;7627.733029344168;7669.88495172584;7744.7676569703;7393.852122957618;7451.962740186264;7494.925050749423;7628.656710447932;7633.885491717518;6998.335158159966;7068.787936361918;7123.038389817309;7132.964335178291;7134.46491513149;4467.754273514988;4821.421429428491;4959.553640172402;5116.9744151279;5130.640855140105;4965.255211718271;5109.77365432301;5114.948850511596;5247.449017853223;5264.15773476242 05:55:58 INFO - PROCESS | 1660 | |4;prototype.html;281.16774347930124;298.58645775600786;306.0527666871033;313.2982120051085;315.55034076441063;4643.558861908122;4685.8125674973;5062.569681577066;5405.648632838867;5505.944940550593;5186.896262074766;5663.631863928842;5675.035244008518;5712.857178570538;5730.856728581787;4114.876553703386;4202.327627579588;4279.251131052069;4283.67872409569;4340.305551111807;3711.4247291669835;3766.9434958475645;3865.9613403865883;4074.2091667208056;4301.741895486265;3496.2133519957933;3499.9300013999705;3516.40221162403;4049.6557792587664;4171.645410140127;3967.6032396760093;4265.317549192115;4301.935470967938;4341.41390912226;4359.324304732787;3620.456931460276;3624.691901188402;3628.310620982005;3632.54593175853;3640.7087433005295;5535.750891209906;5548.751530905554;5595.664260144405;5624.465675760837;5667.603267771257;4082.6733861291027;4179.370045682186;4563.315502674593;4667.789949452283;4850.83022094225;5207.849251203043;5972.850678733023;5994.430529099728;6001.06983417571;6033.5173186145;3355.07735372772;3873.4189871519216;3952.802359882023;4027.939580906289;4030.609439743284;5914.645121292693;6188.050764009323;6276.717547710318;6285.151504546873;6325.588836725598;3997.960020399759;4009.8797036088963;4013.9397909031386;4033.6773058155277;4035.5964403559997;3037.8632961516787;3492.947605785915;3637.399829028234;3852.97896057545;4092.7107960992194;3749.8125093745202;3932.4297976793205;4871;4871.537203965618;4888.584470320063;5389.757460914268;5923.644581325048;5975.342712301644;6014.376118448082;6126.866529692022;1088.78768640116;1381.9930900345435;1403.8315402151602;1405.9226742529258;1413.2439145057344;804.1958041958042;845.7843249971218;854.5171977832629;858.7380848841038;860.0281681699639;5395.757190926418;5430.8913821723345;5599.664020158803;5657.8019769307875;5663.037283661787;5088.931324421839;5235.790568377299;6157.876842463215;6274.709730948171;6333.764915841459;5240.689827543114;5317.351620997503;5440.700761458158;5571.771291483358;5652.293463317085;2578.8968441262514;2698.9595156072673;3123.9375212495625;3211.2614098757417;3271.329377477611;6004.939950600526;6378.712957916905;6390.520710946605;6443.712482068891;6476.546641735127;6228.88555722139;6294.8111556653375;6335.303116657164;6336.746530138835;6346.524010699216;6280.1280802449855;6322.146510221061;6385.297617262097;6426.614403135827;6442.871142577123;4690.484046754786;5735.426457354398;6107.938920610737;6111.786087486917;6186.566940314315;4646.931205822612;6042.214512113397;6058.848528786815;6078.717492553971;6105.633661980295;5143.974280128576;5603.93525230205;6393.776217832354;6476.5751534662295;6515.413612774683;3818.4081467372603;3999.6800255980033;4001.8999525010945;4015.5181378234797;4040.4343391924567;5429;6177.505799536116;6189.535784816067;6206.534509911684;6214.166820787788;5472.6990015547935;5680.9147862781265;5935.34711181761;5989.855325953735;6031.60794548353;5142.97428512855;5300.56884641137;5995.880082398415;5999.820005399845;6009.33430607338;5642.758593109509;5880.089355768921;5880.911786323294;5883.382244864228;5908.911366329423;5220.451852555579;5994.6403215807195;5995.670238136944;6008.986989358614;6089.269287685506;5007.449180590059;5850.297964244148;5862.618929769551;5923.229980102731;5927.940720592739 05:55:58 INFO - PROCESS | 1660 | |5;yui.html;595.8748662780819;688.5180373738384;722.4112348436024;764.2624867003344;823.3125340340813;13049.80425293619;15314.310856011478;15535.223238838069;16009.839901600966;16043.117628530426;14184.43262269508;14594.708105837877;14598.489052883151;14618;14635.048721833073;673.4746897420008;819.1890028871404;863.926566241867;864.6411739128254;884.4648987362649;844.4679851693455;866.2030931542964;870.060334838373;870.6865528409799;875.1030194051085;876.6230520876021;894.4096896048609;897.5512243878061;929.3633860805336;930.432436213909;891.425030855098;908.3732224764924;913.8994710581898;922.7462447826834;923.4782347973373;672.7510820996263;682.6518475577442;685.6057766784119;686.193722376211;687.285223367697;14556.126632402089;14886.70226595473;14888.925555372154;14893.77659335111;14902.105873647615;14580.198089105095;14815.555533334018;14826.851731482762;14952.327145278488;14955.925220373938;10326.638567650096;12030.759384812342;12287.93856030714;12544.937275313565;12600.68498287541;3829.880653015597;3873.825677844504;3941.9211615767813;4070.653994410479;4101.323281658522;125452.94076814041;126107.99999999908;126657.73342266552;126802.36598816946;127902;11109.888901111048;11370.715732106764;11411.144164187719;11434.656960291204;11977.940110299567;23371;23623.409414764425;23751.881240593688;23792.643110353358;23855.64216536753;8027.438079334391;8181.468204566803;8236.546989915612;8312.8753068704;8391.874121888177;4001.599840015975;4322.265214913472;4383.823214969446;4527.773611319487;4547.295169248771;3348;3393.1856354475244;3429.7770644908;3485.233248685285;3487.9302413951577;636.8821767972847;643.469137961184;643.9979392065901;645.1484041065842;667.396006614015;555.2559570175983;591.382005803936;626.6334194496179;654.0581562549913;665.6139439125295;7644.312011918954;9104.499252541042;9324.673636422693;9335.159835614828;9445.480498572508;569.8717788497638;594.402625361509;649.6621756686496;655.9163756161639;681.4514315975687;3563.4832949222737;4264.530901600821;4292.18448494785;4474.753888536096;4613.584777369986;167964;168945;169232;170664;173791;90383.09616903878;90744;128132;150403;153407;93386;122352;125482.3725881383;128794;128922.35538822245;8557.48655080697;8859.955700221457;8969.641214351353;8977.730668079968;9005.684801031932;55849.162262566904;63628.363716364096;63850;65314;66720;84203.15796841953;93555;97081;101595;104730;11188.384638844942;11396;11435.656930291772;11563.6530904073;11766.411679416165;12644.43100060481;12672.366381681064;12730;13141.737165256833;13163.802542961672;11256.7748645025;11595.072394208612;11677.299362038304;12446.315452650191;12520.248785072925;11724.296542207154;11961.940190298992;12433.502659893504;12478.25130492137;12532.937335313265;11529.827052594386;11853.288802671867;12027.819582706441;12402.937985310376;12470.625881223577;8770.166834150745;9471.715848524555;10062.547185376821;10217.693469195936;10396.688099357032;8203.26170644621;8823.764672945665;9718;10170.491475426346;10174.338667986558 05:55:58 INFO - PROCESS | 1660 | __end_tp_report 05:55:58 INFO - PROCESS | 1660 | __start_cc_report 05:55:58 INFO - PROCESS | 1660 | _x_x_mozilla_cycle_collect,407 05:55:58 INFO - PROCESS | 1660 | __end_cc_report 05:55:58 INFO - PROCESS | 1660 | __startTimestamp1470660958100__endTimestamp 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - PROCESS | 1660 | ------- Summary: start ------- 05:55:58 INFO - PROCESS | 1660 | Number of tests: 6 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - PROCESS | 1660 | [#0] dojo.html Cycles:165 Average:5878.83 Median:6166.17 stddev:675.44 (11.0%) stddev-sans-first:649.40 05:55:58 INFO - PROCESS | 1660 | Values: 3420.6 3431.8 3472.2 3481.8 3494.8 5810.4 5822.1 5881.6 5925.6 5942.3 5694.0 5861.2 5888.9 5936.6 5941.8 5245.6 5280.6 5388.4 5392.2 5437.1 5332.8 5398.9 5471.2 5499.4 5507.0 4382.6 5270.6 5298.6 5385.9 5410.9 4240.8 5364.3 5380.1 5387.8 5431.9 4498.2 5304.8 5316.8 5352.6 5359.6 4741.7 5745.5 5758.5 5852.8 6002.4 6224.0 6262.8 6303.5 6316.6 6338.0 6382.6 6386.7 6405.9 6413.6 6417.6 5932.0 6025.3 6032.8 6064.2 6081.9 6491.4 6501.3 6501.6 6510.6 6514.6 6166.2 6301.5 6303.6 6312.4 6325.0 6211.6 6262.1 6277.5 6372.2 6402.6 6218.2 6227.7 6285.7 6286.4 6292.6 6232.8 6258.6 6292.1 6304.0 6314.6 5059.4 5063.5 5108.4 5127.8 5130.5 4543.8 4557.6 4561.0 4576.9 4656.0 5966.3 6052.5 6058.5 6067.3 6092.3 6310.4 6347.3 6351.7 6357.2 6370.6 5824.4 5952.7 5961.6 6032.5 6109.5 5587.0 5593.8 5603.2 5606.3 5611.0 6465.1 6538.1 6547.5 6548.8 6555.1 6175.7 6298.2 6298.8 6325.0 6401.2 6563.3 6568.2 6601.8 6606.4 6620.5 6327.1 6345.7 6347.2 6348.0 6353.7 6229.5 6304.9 6323.6 6355.7 6391.9 5292.4 5980.8 6193.9 6260.0 6268.0 6218.2 6229.0 6273.2 6293.0 6315.5 5898.2 6074.6 6146.3 6160.0 6233.4 6255.4 6257.1 6258.8 6295.9 6301.1 6011.3 6210.4 6224.9 6226.4 6247.3 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - PROCESS | 1660 | [#1] ext.html Cycles:180 Average:71487.22 Median:39516.80 stddev:164413.35 (416.1%) stddev-sans-first:164788.05 05:55:58 INFO - PROCESS | 1660 | Values: 445.4 490.7 507.1 543.9 555.0 30648.7 40585.0 40612.4 40629.6 40661.2 40045.0 40626.4 40790.6 41056.0 41357.0 8339.4 9602.7 9784.4 9801.6 9815.5 9568.1 9602.3 9617.3 9661.8 9685.8 9696.7 9753.8 9754.4 9765.2 9767.8 8131.9 9613.0 9736.8 9755.4 9758.3 9628.8 9673.7 9702.4 9726.9 9732.7 39173.0 39340.8 39432.0 39515.6 39518.0 2810.3 3259.8 3287.4 3296.8 3469.5 28821.7 30251.7 30278.1 30623.2 31338.4 3098.7 3101.2 3110.6 3133.6 3198.2 417000.9 447769.0 451119.0 451776.0 453072.0 33359.5 33381.5 33526.7 33572.2 33599.3 33791.3 34546.3 34680.5 34770.8 35457.5 15876.5 16152.4 16399.0 16462.7 16464.0 12392.0 12513.2 12611.7 12641.5 12663.2 18778.8 19222.0 19274.3 19285.0 19343.0 6955.6 7963.6 8146.5 8156.3 8235.8 866.5 903.5 995.0 1018.7 1172.1 24548.3 29716.4 30223.9 30735.0 30897.1 997.3 1030.4 1081.9 1092.8 1120.5 13898.6 14655.3 15564.7 15704.6 16059.6 706204.0 712373.0 712580.0 712692.0 713483.0 58992.1 59411.4 59995.7 59998.1 60059.7 1326.0 1358.0 1389.3 1389.9 1392.2 27929.6 29077.4 29675.7 30140.4 30283.8 50463.0 51159.0 51189.5 51264.0 51309.2 640755.0 643479.0 650400.0 654495.0 655152.0 22307.8 22724.0 26538.5 26940.2 27368.6 47154.8 47433.8 47576.0 48909.3 49248.5 40031.2 40212.0 40906.6 41046.0 41587.6 39763.6 40641.6 40681.4 40757.4 41072.8 37236.1 37729.1 38483.0 38548.0 38837.4 34037.5 34827.0 35568.9 35579.8 35662.0 23941.9 24803.9 25420.0 25661.0 26514.6 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - PROCESS | 1660 | [#2] jquery.html Cycles:180 Average:33828.17 Median:35377.73 stddev:89930.21 (254.2%) stddev-sans-first:90147.30 05:55:58 INFO - PROCESS | 1660 | Values: 321.0 363.0 376.4 389.5 399.1 20385.3 20409.5 21332.4 21528.0 21772.0 20723.2 21122.4 21417.9 21591.1 21670.1 5008.4 5954.7 5964.0 6028.3 6083.1 5832.2 5843.7 5845.4 5845.4 5960.9 5685.2 5806.1 5860.0 5923.9 5926.4 5766.3 5775.9 5917.4 5920.3 5935.3 5050.5 5329.5 5395.9 5425.5 5455.3 13362.8 13434.6 13675.8 13726.2 23536.9 2306.0 2352.3 2530.6 3015.5 3015.7 13855.4 15171.1 16363.3 17171.7 17958.8 1905.2 1930.6 1963.5 2020.2 2039.9 88731.6 110722.4 116446.4 143833.0 148639.0 21379.6 21944.9 22074.6 22159.7 22287.0 35352.5 35403.0 35419.5 35599.0 35601.8 10270.2 10673.9 10928.9 11071.4 11150.6 7465.7 8412.4 9030.9 9092.3 9104.4 9862.4 9899.0 9906.5 9909.1 9997.4 3316.8 3789.4 3899.7 3960.7 3961.4 860.9 900.4 928.2 944.2 990.8 15282.5 21134.9 21360.0 21425.4 21528.7 851.6 958.7 1017.3 1027.9 1036.3 9475.2 10643.6 11263.3 11372.5 11422.5 226299.6 506333.0 606976.0 611165.0 613164.0 88906.0 128830.0 130578.3 132081.0 135840.3 949.1 957.0 965.0 974.8 979.2 18759.9 18983.9 19552.7 20039.9 20046.6 51666.5 53246.7 53345.7 54006.7 54912.0 79275.0 80546.2 81387.0 81412.0 84626.6 7230.9 7921.4 8143.6 8231.2 8378.7 9378.0 12455.1 13042.2 13243.7 13594.3 11253.8 11354.9 11420.6 11683.5 11705.2 9327.7 9555.8 11250.4 11328.0 11515.5 11565.5 11708.8 11891.8 11895.3 11917.3 7122.8 8015.6 8028.2 8215.2 8456.9 11062.6 11286.3 11509.4 11547.7 11629.3 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - PROCESS | 1660 | [#3] mootools.html Cycles:180 Average:5701.81 Median:4719.86 stddev:3180.15 (67.4%) stddev-sans-first:3173.72 05:55:58 INFO - PROCESS | 1660 | Values: 1543.8 1570.1 1767.7 1828.5 1892.2 6978.0 7263.7 7976.5 9020.2 9048.3 8653.8 8857.4 8863.2 8876.9 8896.7 1969.9 2327.5 2352.5 2362.1 2364.1 1981.2 2338.9 2377.5 2409.5 2410.7 2365.2 2371.6 2380.4 2397.3 2407.4 1945.6 2259.8 2278.7 2279.6 2285.6 2365.6 2370.5 2371.5 2376.3 2385.9 8933.2 8978.8 8987.2 8990.2 9012.5 5219.1 5278.7 5300.9 5377.8 5379.9 3362.6 3449.3 3538.5 3539.5 3603.1 1097.7 1112.8 1788.5 1857.5 1906.5 11096.1 11264.2 11419.7 11579.8 11692.0 4682.0 4786.3 4790.3 4894.7 4895.2 10130.3 10151.4 10154.5 10154.7 10163.9 5360.0 5372.3 5381.4 5394.4 5411.2 4405.9 4734.2 4850.2 4874.7 4914.7 3923.6 3947.9 4042.6 4092.4 4098.0 1115.6 1287.6 1300.6 1301.4 1308.3 919.3 923.7 945.5 948.3 999.8 4705.5 5964.3 6009.4 6028.5 6141.7 439.0 440.1 442.8 449.4 449.7 3915.9 4010.9 4158.1 4169.0 4181.0 10441.8 10593.9 10795.5 10872.8 10927.7 10540.6 10671.4 10713.6 10787.0 10884.6 8095.2 8146.3 8329.8 8342.3 8349.1 5844.7 5934.5 5997.6 6037.2 6046.6 8365.3 9997.9 10118.9 10121.9 10152.6 7963.9 10041.2 10047.1 10212.7 10239.8 6109.9 7009.1 7397.1 7528.5 7696.2 7352.2 8343.2 8349.7 8399.4 8420.9 7507.0 7597.8 7627.7 7669.9 7744.8 7393.9 7452.0 7494.9 7628.7 7633.9 6998.3 7068.8 7123.0 7133.0 7134.5 4467.8 4821.4 4959.6 5117.0 5130.6 4965.3 5109.8 5114.9 5247.4 5264.2 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - PROCESS | 1660 | [#4] prototype.html Cycles:180 Average:4784.06 Median:5435.80 stddev:1552.72 (28.6%) stddev-sans-first:1519.85 05:55:58 INFO - PROCESS | 1660 | Values: 281.2 298.6 306.1 313.3 315.6 4643.6 4685.8 5062.6 5405.6 5505.9 5186.9 5663.6 5675.0 5712.9 5730.9 4114.9 4202.3 4279.3 4283.7 4340.3 3711.4 3766.9 3866.0 4074.2 4301.7 3496.2 3499.9 3516.4 4049.7 4171.6 3967.6 4265.3 4301.9 4341.4 4359.3 3620.5 3624.7 3628.3 3632.5 3640.7 5535.8 5548.8 5595.7 5624.5 5667.6 4082.7 4179.4 4563.3 4667.8 4850.8 5207.8 5972.9 5994.4 6001.1 6033.5 3355.1 3873.4 3952.8 4027.9 4030.6 5914.6 6188.1 6276.7 6285.2 6325.6 3998.0 4009.9 4013.9 4033.7 4035.6 3037.9 3492.9 3637.4 3853.0 4092.7 3749.8 3932.4 4871.0 4871.5 4888.6 5389.8 5923.6 5975.3 6014.4 6126.9 1088.8 1382.0 1403.8 1405.9 1413.2 804.2 845.8 854.5 858.7 860.0 5395.8 5430.9 5599.7 5657.8 5663.0 5088.9 5235.8 6157.9 6274.7 6333.8 5240.7 5317.4 5440.7 5571.8 5652.3 2578.9 2699.0 3123.9 3211.3 3271.3 6004.9 6378.7 6390.5 6443.7 6476.5 6228.9 6294.8 6335.3 6336.7 6346.5 6280.1 6322.1 6385.3 6426.6 6442.9 4690.5 5735.4 6107.9 6111.8 6186.6 4646.9 6042.2 6058.8 6078.7 6105.6 5144.0 5603.9 6393.8 6476.6 6515.4 3818.4 3999.7 4001.9 4015.5 4040.4 5429.0 6177.5 6189.5 6206.5 6214.2 5472.7 5680.9 5935.3 5989.9 6031.6 5143.0 5300.6 5995.9 5999.8 6009.3 5642.8 5880.1 5880.9 5883.4 5908.9 5220.5 5994.6 5995.7 6009.0 6089.3 5007.4 5850.3 5862.6 5923.2 5927.9 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - PROCESS | 1660 | [#5] yui.html Cycles:180 Average:25929.68 Median:3851.85 stddev:43366.74 (1125.9%) stddev-sans-first:43446.68 05:55:58 INFO - PROCESS | 1660 | Values: 595.9 688.5 722.4 764.3 823.3 13049.8 15314.3 15535.2 16009.8 16043.1 14184.4 14594.7 14598.5 14618.0 14635.0 673.5 819.2 863.9 864.6 884.5 844.5 866.2 870.1 870.7 875.1 876.6 894.4 897.6 929.4 930.4 891.4 908.4 913.9 922.7 923.5 672.8 682.7 685.6 686.2 687.3 14556.1 14886.7 14888.9 14893.8 14902.1 14580.2 14815.6 14826.9 14952.3 14955.9 10326.6 12030.8 12287.9 12544.9 12600.7 3829.9 3873.8 3941.9 4070.7 4101.3 125452.9 126108.0 126657.7 126802.4 127902.0 11109.9 11370.7 11411.1 11434.7 11977.9 23371.0 23623.4 23751.9 23792.6 23855.6 8027.4 8181.5 8236.5 8312.9 8391.9 4001.6 4322.3 4383.8 4527.8 4547.3 3348.0 3393.2 3429.8 3485.2 3487.9 636.9 643.5 644.0 645.1 667.4 555.3 591.4 626.6 654.1 665.6 7644.3 9104.5 9324.7 9335.2 9445.5 569.9 594.4 649.7 655.9 681.5 3563.5 4264.5 4292.2 4474.8 4613.6 167964.0 168945.0 169232.0 170664.0 173791.0 90383.1 90744.0 128132.0 150403.0 153407.0 93386.0 122352.0 125482.4 128794.0 128922.4 8557.5 8860.0 8969.6 8977.7 9005.7 55849.2 63628.4 63850.0 65314.0 66720.0 84203.2 93555.0 97081.0 101595.0 104730.0 11188.4 11396.0 11435.7 11563.7 11766.4 12644.4 12672.4 12730.0 13141.7 13163.8 11256.8 11595.1 11677.3 12446.3 12520.2 11724.3 11961.9 12433.5 12478.3 12532.9 11529.8 11853.3 12027.8 12402.9 12470.6 8770.2 9471.7 10062.5 10217.7 10396.7 8203.3 8823.8 9718.0 10170.5 10174.3 05:55:58 INFO - PROCESS | 1660 | -------- Summary: end -------- 05:55:58 INFO - PROCESS | 1660 | 05:55:58 INFO - TEST-INFO | 1660: exit 0 05:55:58 INFO - TEST-OK | dromaeo_css | took 1115018ms 05:55:58 INFO - TEST-START | kraken 05:55:58 INFO - operating with platform_type : mac_ 05:55:58 INFO - Initialising browser for kraken test... 05:55:58 INFO - TEST-INFO | started process 1671 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/tmp9Pj4kT/profile http://localhost:49279/getInfo.html) 05:56:01 INFO - PROCESS | 1671 | __metrics Screen width/height:1600/1200 05:56:01 INFO - PROCESS | 1671 | colorDepth:24 05:56:01 INFO - PROCESS | 1671 | Browser inner width/height: 1024/689 05:56:01 INFO - PROCESS | 1671 | __metrics 05:56:01 ERROR - PROCESS | 1671 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 05:56:02 INFO - TEST-INFO | 1671: exit 0 05:56:02 INFO - Browser initialized. 05:56:02 INFO - Running cycle 1/1 for kraken test... 05:56:02 INFO - TEST-INFO | started process 1674 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/tmp9Pj4kT/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:56:14 INFO - PROCESS | 1674 | RSS: Main: 254664704 05:56:14 INFO - PROCESS | 1674 | 05:56:17 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49279/tests/kraken/driver.html?testName=audio-beat-detection) 05:56:18 INFO - PROCESS | 1674 | RSS: Main: 267603968 05:56:18 INFO - PROCESS | 1674 | 05:56:21 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49279/tests/kraken/driver.html?testName=audio-dft) 05:56:21 INFO - PROCESS | 1674 | RSS: Main: 276246528 05:56:21 INFO - PROCESS | 1674 | 05:56:25 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49279/tests/kraken/driver.html?testName=audio-fft) 05:56:26 INFO - PROCESS | 1674 | RSS: Main: 279453696 05:56:26 INFO - PROCESS | 1674 | 05:56:28 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49279/tests/kraken/driver.html?testName=audio-oscillator) 05:56:28 INFO - PROCESS | 1674 | RSS: Main: 281681920 05:56:28 INFO - PROCESS | 1674 | 05:56:30 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49279/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:56:31 INFO - PROCESS | 1674 | RSS: Main: 282230784 05:56:31 INFO - PROCESS | 1674 | 05:56:34 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49279/tests/kraken/driver.html?testName=imaging-darkroom) 05:56:35 INFO - PROCESS | 1674 | RSS: Main: 282222592 05:56:35 INFO - PROCESS | 1674 | 05:56:38 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49279/tests/kraken/driver.html?testName=imaging-desaturate) 05:56:39 INFO - PROCESS | 1674 | RSS: Main: 282652672 05:56:39 INFO - PROCESS | 1674 | 05:56:42 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49279/tests/kraken/driver.html?testName=json-parse-financial) 05:56:42 INFO - PROCESS | 1674 | RSS: Main: 282779648 05:56:42 INFO - PROCESS | 1674 | 05:56:44 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49279/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:56:45 INFO - PROCESS | 1674 | RSS: Main: 282419200 05:56:45 INFO - PROCESS | 1674 | 05:56:47 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49279/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:56:47 INFO - PROCESS | 1674 | RSS: Main: 282537984 05:56:47 INFO - PROCESS | 1674 | 05:56:49 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49279/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:56:50 INFO - PROCESS | 1674 | RSS: Main: 282910720 05:56:50 INFO - PROCESS | 1674 | 05:56:53 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49279/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:56:54 INFO - PROCESS | 1674 | RSS: Main: 283021312 05:56:54 INFO - PROCESS | 1674 | 05:56:57 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49279/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:56:57 INFO - PROCESS | 1674 | RSS: Main: 283123712 05:56:57 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | Cycle 1(1): loaded http://localhost:49279/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49279/tests/kraken/driver.html?testName=ai-astar) 05:56:59 INFO - PROCESS | 1674 | RSS: Main: 285122560 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | __start_tp_report 05:56:59 INFO - PROCESS | 1674 | _x_x_mozilla_page_load 05:56:59 INFO - PROCESS | 1674 | _x_x_mozilla_page_load_details 05:56:59 INFO - PROCESS | 1674 | |i|pagename|runs| 05:56:59 INFO - PROCESS | 1674 | |0;ai-astar;105;115;105;119;96;170;100;174;172;164 05:56:59 INFO - PROCESS | 1674 | |1;audio-beat-detection;164;140;141;188;140;137;129;112;179;138 05:56:59 INFO - PROCESS | 1674 | |2;audio-dft;247;255;284;271;197;198;236;211;203;199 05:56:59 INFO - PROCESS | 1674 | |3;audio-fft;66;100;104;179;84;59;61;61;129;58 05:56:59 INFO - PROCESS | 1674 | |4;audio-oscillator;69;73;137;98;101;107;110;73;59;102 05:56:59 INFO - PROCESS | 1674 | |5;imaging-gaussian-blur;91;89;133;122;89;98;119;89;91;86 05:56:59 INFO - PROCESS | 1674 | |6;imaging-darkroom;96;123;148;103;148;148;103;148;109;119 05:56:59 INFO - PROCESS | 1674 | |7;imaging-desaturate;76;96;78;152;143;103;84;144;151;137 05:56:59 INFO - PROCESS | 1674 | |8;json-parse-financial;60;71;63;57;58;55;57;65;72;71 05:56:59 INFO - PROCESS | 1674 | |9;json-stringify-tinderbox;67;73;70;74;75;85;74;80;102;106 05:56:59 INFO - PROCESS | 1674 | |10;stanford-crypto-aes;85;87;85;88;85;83;85;86;89;87 05:56:59 INFO - PROCESS | 1674 | |11;stanford-crypto-ccm;155;156;151;155;141;140;142;144;164;160 05:56:59 INFO - PROCESS | 1674 | |12;stanford-crypto-pbkdf2;171;228;176;176;166;165;168;193;195;170 05:56:59 INFO - PROCESS | 1674 | |13;stanford-crypto-sha256-iterative;66;68;67;67;68;68;68;65;67;68 05:56:59 INFO - PROCESS | 1674 | __end_tp_report 05:56:59 INFO - PROCESS | 1674 | __start_cc_report 05:56:59 INFO - PROCESS | 1674 | _x_x_mozilla_cycle_collect,1091 05:56:59 INFO - PROCESS | 1674 | __end_cc_report 05:56:59 INFO - PROCESS | 1674 | __startTimestamp1470661019854__endTimestamp 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | ------- Summary: start ------- 05:56:59 INFO - PROCESS | 1674 | Number of tests: 14 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#0] ai-astar Cycles:10 Average:132.00 Median:167.00 stddev:33.45 (20.0%) stddev-sans-first:34.02 05:56:59 INFO - PROCESS | 1674 | Values: 105.0 115.0 105.0 119.0 96.0 170.0 100.0 174.0 172.0 164.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#1] audio-beat-detection Cycles:10 Average:146.80 Median:140.50 stddev:23.23 (16.5%) stddev-sans-first:23.79 05:56:59 INFO - PROCESS | 1674 | Values: 164.0 140.0 141.0 188.0 140.0 137.0 129.0 112.0 179.0 138.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#2] audio-dft Cycles:10 Average:230.10 Median:241.50 stddev:32.85 (13.6%) stddev-sans-first:34.27 05:56:59 INFO - PROCESS | 1674 | Values: 247.0 255.0 284.0 271.0 197.0 198.0 236.0 211.0 203.0 199.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#3] audio-fft Cycles:10 Average:90.10 Median:60.00 stddev:39.46 (65.8%) stddev-sans-first:40.88 05:56:59 INFO - PROCESS | 1674 | Values: 66.0 100.0 104.0 179.0 84.0 59.0 61.0 61.0 129.0 58.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#4] audio-oscillator Cycles:10 Average:92.90 Median:64.00 stddev:23.86 (37.3%) stddev-sans-first:23.69 05:56:59 INFO - PROCESS | 1674 | Values: 69.0 73.0 137.0 98.0 101.0 107.0 110.0 73.0 59.0 102.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#5] imaging-gaussian-blur Cycles:10 Average:100.70 Median:89.00 stddev:17.17 (19.3%) stddev-sans-first:17.85 05:56:59 INFO - PROCESS | 1674 | Values: 91.0 89.0 133.0 122.0 89.0 98.0 119.0 89.0 91.0 86.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#6] imaging-darkroom Cycles:10 Average:124.50 Median:148.00 stddev:21.65 (14.6%) stddev-sans-first:20.36 05:56:59 INFO - PROCESS | 1674 | Values: 96.0 123.0 148.0 103.0 148.0 148.0 103.0 148.0 109.0 119.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#7] imaging-desaturate Cycles:10 Average:116.40 Median:114.00 stddev:31.82 (27.9%) stddev-sans-first:30.20 05:56:59 INFO - PROCESS | 1674 | Values: 76.0 96.0 78.0 152.0 143.0 103.0 84.0 144.0 151.0 137.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#8] json-parse-financial Cycles:10 Average:62.90 Median:64.00 stddev:6.52 (10.2%) stddev-sans-first:6.83 05:56:59 INFO - PROCESS | 1674 | Values: 60.0 71.0 63.0 57.0 58.0 55.0 57.0 65.0 72.0 71.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#9] json-stringify-tinderbox Cycles:10 Average:80.60 Median:74.00 stddev:13.32 (18.0%) stddev-sans-first:13.19 05:56:59 INFO - PROCESS | 1674 | Values: 67.0 73.0 70.0 74.0 75.0 85.0 74.0 80.0 102.0 106.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#10] stanford-crypto-aes Cycles:10 Average:86.00 Median:86.50 stddev:1.76 (2.0%) stddev-sans-first:1.83 05:56:59 INFO - PROCESS | 1674 | Values: 85.0 87.0 85.0 88.0 85.0 83.0 85.0 86.0 89.0 87.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#11] stanford-crypto-ccm Cycles:10 Average:150.80 Median:155.00 stddev:8.55 (5.5%) stddev-sans-first:8.93 05:56:59 INFO - PROCESS | 1674 | Values: 155.0 156.0 151.0 155.0 141.0 140.0 142.0 144.0 164.0 160.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:180.80 Median:176.00 stddev:19.63 (11.2%) stddev-sans-first:20.50 05:56:59 INFO - PROCESS | 1674 | Values: 171.0 228.0 176.0 176.0 166.0 165.0 168.0 193.0 195.0 170.0 05:56:59 INFO - PROCESS | 1674 | 05:56:59 INFO - PROCESS | 1674 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.20 Median:68.00 stddev:1.03 (1.5%) stddev-sans-first:1.00 05:56:59 INFO - PROCESS | 1674 | Values: 66.0 68.0 67.0 67.0 68.0 68.0 68.0 65.0 67.0 68.0 05:56:59 INFO - PROCESS | 1674 | -------- Summary: end -------- 05:56:59 INFO - PROCESS | 1674 | 05:57:00 INFO - TEST-INFO | 1674: exit 0 05:57:00 INFO - TEST-OK | kraken | took 61853ms 05:57:00 INFO - SUITE-END | took 1176s 05:57:01 INFO - Completed test suite (00:19:37) 05:57:01 INFO - javascript benchmark 05:57:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7502.638957888904, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3420.5724284464436, 3431.845566949487, 3472.236108056227, 3481.825908704564, 3494.8077855717925, 5810.418958104187, 5822.126680997852, 5881.55888308377, 5925.5555833312455, 5942.346341902387, 5693.975084484791, 5861.238039054917, 5888.852778680535, 5936.554758393117, 5941.792037278696, 5245.580353571724, 5280.630355875091, 5388.353397592295, 5392.245085688007, 5437.13005919053, 5332.786688532454, 5398.865028374303, 5471.23402723619, 5499.422560631137, 5506.972465137689, 4382.6055654991205, 5270.631055826094, 5298.602604804655, 5385.946140538623, 5410.8917821643545, 4240.787960601989, 5364.302640656729, 5380.058489764315, 5387.81142660005, 5431.945680543184, 4498.212812757754, 5304.814331498379, 5316.813911513079, 5352.57179425645, 5359.598030147716, 4741.715497070187, 5745.48290653839, 5758.539316854683, 5852.76588936442, 6002.369751176151, 6223.96888015557, 6262.843428914268, 6303.5272354573135, 6316.557840951135, 6338.0, 6382.585131966453, 6386.744530218785, 6405.903911441332, 6413.647249401281, 6417.582857114273, 5931.9703401483575, 6025.3372129065765, 6032.788852390146, 6064.211652485193, 6081.939180608138, 6491.383318584727, 6501.349865013461, 6501.609903405811, 6510.609363438209, 6514.6416947068365, 6166.167567378437, 6301.495880329563, 6303.590266632654, 6312.400321969406, 6324.988001919671, 6211.565190436717, 6262.091996660459, 6277.497800175975, 6372.2353317601255, 6402.6158430494315, 6218.19163508741, 6227.688615569294, 6285.748570057238, 6286.402791734778, 6292.622442653455, 6232.781852635227, 6258.624482531062, 6292.119103325538, 6303.968480157661, 6314.589551679218, 5059.443461219263, 5063.518965698253, 5108.438071812097, 5127.769250383742, 5130.51260130287, 4543.750093744809, 4557.635389168859, 4561.0, 4576.931346029813, 4656.0, 5966.313873904556, 6052.485538729169, 6058.454739073504, 6067.302260240041, 6092.299385570627, 6310.368963103653, 6347.333529979378, 6351.682415879188, 6357.205349331333, 6370.617762934239, 5824.446677565625, 5952.7321270542925, 5961.552883533753, 6032.517398608101, 6109.480694140959, 5587.0, 5593.8321850344555, 5603.215549823028, 5606.271184746039, 5610.971945140248, 6465.062565927914, 6538.117354157128, 6547.508936829757, 6548.8035358939305, 6555.082288479522, 6175.69121543912, 6298.244210694746, 6298.811035668754, 6325.019621958604, 6401.199850018747, 6563.278039415565, 6568.1789776277965, 6601.768938087144, 6606.405423511907, 6620.470362371095, 6327.11420401135, 6345.682715864281, 6347.174867267226, 6348.0, 6353.745850166127, 6229.53278504123, 6304.873902522016, 6323.588966717149, 6355.745770169141, 6391.8721625566295, 5292.4442933492965, 5980.803839232084, 6193.876122477615, 6259.998400255937, 6268.0, 6218.236769788745, 6229.034499652561, 6273.247210334789, 6293.0, 6315.463185629089, 5898.203742494708, 6074.635521868702, 6146.262448506029, 6159.969200153971, 6233.438990490878, 6255.374462553708, 6257.061440783918, 6258.780942666985, 6295.874082518232, 6301.086342480223, 6011.338752737108, 6210.378962103753, 6224.9377506224355, 6226.408491193511, 6247.281562620356], "value": 5835.828815717731, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [445.43652279865955, 490.6663468841188, 507.1100219115452, 543.8531596468956, 554.9511423409756, 30648.693513064864, 40585.0, 40612.390814137776, 40629.59370406295, 40661.186776264454, 40044.99999999993, 40626.390604140965, 40790.592094079126, 41055.97360065993, 41357.0, 8339.416240863142, 9602.663906763282, 9784.36401633895, 9801.558929848139, 9815.50922453878, 9568.138867501924, 9602.279829012852, 9617.326787124905, 9661.758456038586, 9685.806283874319, 9696.660616878411, 9753.756156096084, 9754.414735115915, 9765.218782497383, 9767.75580610487, 8131.878021829677, 9612.990635983226, 9736.805263894683, 9755.414675119515, 9758.316917815755, 9628.807423851484, 9673.70978870635, 9702.417854928726, 9726.90273097267, 9732.708018759378, 39173.0, 39340.803295983336, 39432.0, 39515.60484395177, 39518.0, 2810.325521874756, 3259.788113772621, 3287.4411350070304, 3296.8186749728757, 3469.479578063311, 28821.711782882114, 30251.697483025328, 30278.09165725032, 30623.234419139477, 31338.37323253522, 3098.690130986906, 3101.1936896407096, 3110.5956225690516, 3133.6396314423678, 3198.184462961953, 417000.91499542614, 447769.0, 451119.0, 451776.0, 453071.9999999967, 33359.49960750591, 33381.499277510855, 33526.66473335236, 33572.160695982304, 33599.328013440085, 33791.324173516885, 34546.309073818884, 34680.479792803126, 34770.82614586911, 35457.46813797795, 15876.52370428889, 16152.353905843634, 16399.0, 16462.670746585, 16464.0, 12392.0, 12513.186642868184, 12611.74776504483, 12641.494340226289, 12663.176893502077, 18778.812211877706, 19222.0, 19274.32539861126, 19285.035748212533, 19343.032848357525, 6955.582665040114, 7963.562004089715, 8146.511209327341, 8156.306713929383, 8235.8352832943, 866.4931015356087, 903.4579252448478, 994.9850752238722, 1018.7198520406947, 1172.0799172649429, 24548.263552093467, 29716.40567188644, 30223.942162024225, 30735.0, 30897.07308780695, 997.3168379659957, 1030.3817709374316, 1081.9188560857967, 1092.7759809239087, 1120.5181771838188, 13898.58304250874, 14655.34050967709, 15564.68870622604, 15704.607384815243, 16059.598510037109, 706204.0, 712373.0, 712580.0, 712692.0, 713483.0, 58992.11511827326, 59411.40588594145, 59995.70002150049, 59998.100028499604, 60059.69970150121, 1325.966850828737, 1358.035794585855, 1389.3470069067523, 1389.9166050037031, 1392.1716578635696, 27929.58105628458, 29077.418451630427, 29675.703242967294, 30140.397192056476, 30283.848580757836, 50462.99074018426, 51159.0, 51189.48810511996, 51263.97472050613, 51309.23036154386, 640755.0, 643479.0, 650400.0, 654495.0, 655152.0, 22307.77692223122, 22724.0, 26538.469230614894, 26940.19179424542, 27368.58947115755, 47154.764226178646, 47433.762831185624, 47576.04847903092, 48909.2663610039, 49248.50751492583, 40031.1993760129, 40212.0, 40906.590934091466, 41045.97385065397, 41587.584124159584, 39763.60236397599, 40641.6264576791, 40681.38977915274, 40757.388639171026, 41072.79463602663, 37236.06909827276, 37729.05677357978, 38483.0, 38548.036299092746, 38837.41743873787, 34037.48943765796, 34827.0, 35568.93293201208, 35579.82210088933, 35662.0, 23941.922613482086, 24803.883825227545, 25420.0, 25661.0, 26514.602280965417], "value": 19389.540978459427, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [320.95988001499813, 362.9909252268695, 376.3958846052086, 389.5072732992766, 399.06419446398206, 20385.28651497198, 20409.48976275594, 21332.36002919915, 21528.0, 21772.0, 20723.171073157057, 21122.366329010118, 21417.892910535425, 21591.1363545458, 21670.133194672235, 5008.424031236418, 5954.732037058343, 5963.970180149093, 6028.3067447243475, 6083.148359229689, 5832.154337621064, 5843.737031833556, 5845.3862344453855, 5845.415458454142, 5960.88078238435, 5685.1756495308155, 5806.1000544915605, 5859.970700146515, 5923.911141332884, 5926.436988486087, 5766.250387449605, 5775.884482310373, 5917.4378434048485, 5920.348761636238, 5935.258092738408, 5050.4697006814495, 5329.520343169133, 5395.865103372408, 5425.538829199523, 5455.290812194389, 13362.799558006638, 13434.596962091153, 13675.837553807838, 13726.176429414267, 23536.88231558831, 2305.965410518844, 2352.306069709423, 2530.607755797854, 3015.547667849818, 3015.6833532479213, 13855.376508057161, 15171.089734615958, 16363.281855405248, 17171.656566868718, 17958.820411795845, 1905.247427266222, 1930.6138772245467, 1963.4796778853615, 2020.2424090965887, 2039.857209995301, 88731.55634221788, 110722.44638776834, 116446.41776791147, 143833.0, 148639.0, 21379.572408551743, 21944.89027554852, 22074.558508829734, 22159.667604985938, 22286.997085131206, 35352.46971295433, 35403.0, 35419.4687079694, 35599.0, 35601.8219908904, 10270.229732770073, 10673.893261067446, 10928.945355273172, 11071.391073491035, 11150.60972865962, 7465.7013719450615, 8412.369072319478, 9030.909690903138, 9092.27261819053, 9104.362694611315, 9862.408255504693, 9899.0, 9906.455144967096, 9909.067731792375, 9997.350172238781, 3316.800991940443, 3789.3558095123894, 3899.6880249579967, 3960.742551734128, 3961.3859851723028, 860.9009963854112, 900.3562452846246, 928.2388441478058, 944.2163004706077, 990.7869807991317, 15282.470921747077, 21134.943252837296, 21360.0, 21425.357239282846, 21528.677069843965, 851.6295411496019, 958.7219706285099, 1017.2574020964737, 1027.8612387327764, 1036.3212096077082, 9475.241980641533, 10643.574257029632, 11263.26788758728, 11372.545098196146, 11422.543098276143, 226299.60550591754, 506333.0, 606976.0, 611165.0, 613164.0, 88906.0, 128830.0, 130578.34710826575, 132081.0, 135840.32079839538, 949.1220620925754, 957.0238356875948, 965.0205041882494, 974.8001659659894, 979.1823827104305, 18759.906200469457, 18983.90508047451, 19552.706709399656, 20039.899800500905, 20046.599068018848, 51666.45000649836, 53246.73376633092, 53345.733271333396, 54006.729966349914, 54912.0, 79275.0, 80546.19453805621, 81387.0, 81412.0, 84626.57686711774, 7230.927690723025, 7921.445498815258, 8143.59282035884, 8231.218034286732, 8378.748637540884, 9378.01530839252, 12455.065870059601, 13042.217466952014, 13243.66890827737, 13594.252316122709, 11253.831192532283, 11354.886451135713, 11420.600278990196, 11683.474243659226, 11705.180637355303, 9327.720168394959, 9555.808883822423, 11250.437478126225, 11328.03711684516, 11515.481803318704, 11565.479553420284, 11708.824367634663, 11891.821622675494, 11895.286282823059, 11917.284962902253, 7122.786316410516, 8015.559144247122, 8028.197180281925, 8215.178482151738, 8456.915430845858, 11062.557497700001, 11286.266392684449, 11509.424528773361, 11547.711307217387, 11629.302241865515], "value": 10505.888785930027, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1543.8456154384562, 1570.07365654264, 1767.6818172728904, 1828.4788835181976, 1892.1674463236166, 6978.0, 7263.745768898089, 7976.48152870063, 9020.233280171185, 9048.321375896801, 8653.826923461544, 8857.42426742263, 8863.157999990006, 8876.8668469973, 8896.688615898445, 1969.8916559589218, 2327.4530485335977, 2352.517733864562, 2362.090595120874, 2364.125273648752, 1981.2273213446767, 2338.929832105031, 2377.524495100978, 2409.4819613783034, 2410.650455683925, 2365.195833416638, 2371.5849726297915, 2380.4048987753063, 2397.2688330059327, 2407.422218667516, 1945.5816999345068, 2259.830512711545, 2278.6809846621486, 2279.5782780185637, 2285.5771682238674, 2365.5978483657645, 2370.454795397051, 2371.549405612945, 2376.310869847742, 2385.928422147321, 8933.240674542672, 8978.775530611721, 8987.191152796215, 8990.235829954461, 9012.504312262823, 5219.060569097561, 5278.683279003272, 5300.946990530084, 5377.8117765878005, 5379.946200538023, 3362.562866827321, 3449.3273811606746, 3538.486919396673, 3539.4513850353237, 3603.1172362771026, 1097.7255686078481, 1112.8497652816848, 1788.4902802701167, 1857.5077604434834, 1906.5233691577105, 11096.05683516902, 11264.21150519464, 11419.714507137305, 11579.826302605468, 11692.0, 4681.976590117096, 4786.2581299898575, 4790.281457781361, 4894.657373983787, 4895.167821470359, 10130.290879638354, 10151.390916545031, 10154.492275386201, 10154.746131346776, 10163.898361016443, 5359.981603495401, 5372.3016007919505, 5381.381141168816, 5394.433584473652, 5411.242426060355, 4405.867823965286, 4734.19518681818, 4850.175470170079, 4874.658773885794, 4914.680545764514, 3923.588023257574, 3947.9013024674036, 4042.5755295694116, 4092.3656833190903, 4098.0, 1115.570505355444, 1287.5557932513268, 1300.596814987357, 1301.3688361144837, 1308.3262120008203, 919.2599957034518, 923.6628630549935, 945.4610871803006, 948.2556193388157, 999.8050380175941, 4705.529447055335, 5964.314103878023, 6009.369016253318, 6028.517718582503, 6141.692915354214, 438.9890252743707, 440.11536811010103, 442.81401811239357, 449.3641497281376, 449.67398635988644, 3915.8629447969183, 4010.879673609738, 4158.126793373365, 4169.0411205422315, 4181.017460896687, 10441.84337234942, 10593.947030264799, 10795.460226988776, 10872.836907446395, 10927.726806829893, 10540.631077912236, 10671.359718416765, 10713.625023124154, 10787.029167374974, 10884.564617415215, 8095.23095305945, 8146.30756385702, 8329.750107496906, 8342.332613391036, 8349.123342049119, 5844.6785426801935, 5934.525237981037, 5997.640141591519, 6037.15479832815, 6046.637201767908, 8365.33077353798, 9997.900020999698, 10118.875036242178, 10121.937196594547, 10152.593896244067, 7963.920360796318, 10041.246906481896, 10047.095761381219, 10212.744681383025, 10239.795204096024, 6109.908351374822, 7009.12385951756, 7397.075365579302, 7528.473006889465, 7696.230376962259, 7352.154502232098, 8343.249107580104, 8349.666013359398, 8399.41204115706, 8420.87368689458, 7507.0, 7597.848043038997, 7627.733029344168, 7669.88495172584, 7744.7676569703, 7393.852122957618, 7451.962740186264, 7494.925050749423, 7628.656710447932, 7633.885491717518, 6998.335158159966, 7068.787936361918, 7123.038389817309, 7132.964335178291, 7134.46491513149, 4467.754273514988, 4821.421429428491, 4959.553640172402, 5116.9744151279, 5130.640855140105, 4965.255211718271, 5109.77365432301, 5114.948850511596, 5247.449017853223, 5264.15773476242], "value": 4548.229268151484, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [281.16774347930124, 298.58645775600786, 306.0527666871033, 313.2982120051085, 315.55034076441063, 4643.558861908122, 4685.8125674973, 5062.569681577066, 5405.648632838867, 5505.944940550593, 5186.896262074766, 5663.631863928842, 5675.035244008518, 5712.857178570538, 5730.856728581787, 4114.876553703386, 4202.327627579588, 4279.251131052069, 4283.67872409569, 4340.305551111807, 3711.4247291669835, 3766.9434958475645, 3865.9613403865883, 4074.2091667208056, 4301.741895486265, 3496.2133519957933, 3499.9300013999705, 3516.40221162403, 4049.6557792587664, 4171.645410140127, 3967.6032396760093, 4265.317549192115, 4301.935470967938, 4341.41390912226, 4359.324304732787, 3620.456931460276, 3624.691901188402, 3628.310620982005, 3632.54593175853, 3640.7087433005295, 5535.750891209906, 5548.751530905554, 5595.664260144405, 5624.465675760837, 5667.603267771257, 4082.6733861291027, 4179.370045682186, 4563.315502674593, 4667.789949452283, 4850.83022094225, 5207.849251203043, 5972.850678733023, 5994.430529099728, 6001.06983417571, 6033.5173186145, 3355.07735372772, 3873.4189871519216, 3952.802359882023, 4027.939580906289, 4030.609439743284, 5914.645121292693, 6188.050764009323, 6276.717547710318, 6285.151504546873, 6325.588836725598, 3997.960020399759, 4009.8797036088963, 4013.9397909031386, 4033.6773058155277, 4035.5964403559997, 3037.8632961516787, 3492.947605785915, 3637.399829028234, 3852.97896057545, 4092.7107960992194, 3749.8125093745202, 3932.4297976793205, 4871.0, 4871.537203965618, 4888.584470320063, 5389.757460914268, 5923.644581325048, 5975.342712301644, 6014.376118448082, 6126.866529692022, 1088.78768640116, 1381.9930900345435, 1403.8315402151602, 1405.9226742529258, 1413.2439145057344, 804.1958041958042, 845.7843249971218, 854.5171977832629, 858.7380848841038, 860.0281681699639, 5395.757190926418, 5430.8913821723345, 5599.664020158803, 5657.8019769307875, 5663.037283661787, 5088.931324421839, 5235.790568377299, 6157.876842463215, 6274.709730948171, 6333.764915841459, 5240.689827543114, 5317.351620997503, 5440.700761458158, 5571.771291483358, 5652.293463317085, 2578.8968441262514, 2698.9595156072673, 3123.9375212495625, 3211.2614098757417, 3271.329377477611, 6004.939950600526, 6378.712957916905, 6390.520710946605, 6443.712482068891, 6476.546641735127, 6228.88555722139, 6294.8111556653375, 6335.303116657164, 6336.746530138835, 6346.524010699216, 6280.1280802449855, 6322.146510221061, 6385.297617262097, 6426.614403135827, 6442.871142577123, 4690.484046754786, 5735.426457354398, 6107.938920610737, 6111.786087486917, 6186.566940314315, 4646.931205822612, 6042.214512113397, 6058.848528786815, 6078.717492553971, 6105.633661980295, 5143.974280128576, 5603.93525230205, 6393.776217832354, 6476.5751534662295, 6515.413612774683, 3818.4081467372603, 3999.6800255980033, 4001.8999525010945, 4015.5181378234797, 4040.4343391924567, 5429.0, 6177.505799536116, 6189.535784816067, 6206.534509911684, 6214.166820787788, 5472.6990015547935, 5680.9147862781265, 5935.34711181761, 5989.855325953735, 6031.60794548353, 5142.97428512855, 5300.56884641137, 5995.880082398415, 5999.820005399845, 6009.33430607338, 5642.758593109509, 5880.089355768921, 5880.911786323294, 5883.382244864228, 5908.911366329423, 5220.451852555579, 5994.6403215807195, 5995.670238136944, 6008.986989358614, 6089.269287685506, 5007.449180590059, 5850.297964244148, 5862.618929769551, 5923.229980102731, 5927.940720592739], "value": 4276.297458511825, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [595.8748662780819, 688.5180373738384, 722.4112348436024, 764.2624867003344, 823.3125340340813, 13049.80425293619, 15314.310856011478, 15535.223238838069, 16009.839901600966, 16043.117628530426, 14184.43262269508, 14594.708105837877, 14598.489052883151, 14618.0, 14635.048721833073, 673.4746897420008, 819.1890028871404, 863.926566241867, 864.6411739128254, 884.4648987362649, 844.4679851693455, 866.2030931542964, 870.060334838373, 870.6865528409799, 875.1030194051085, 876.6230520876021, 894.4096896048609, 897.5512243878061, 929.3633860805336, 930.432436213909, 891.425030855098, 908.3732224764924, 913.8994710581898, 922.7462447826834, 923.4782347973373, 672.7510820996263, 682.6518475577442, 685.6057766784119, 686.193722376211, 687.285223367697, 14556.126632402089, 14886.70226595473, 14888.925555372154, 14893.77659335111, 14902.105873647615, 14580.198089105095, 14815.555533334018, 14826.851731482762, 14952.327145278488, 14955.925220373938, 10326.638567650096, 12030.759384812342, 12287.93856030714, 12544.937275313565, 12600.68498287541, 3829.880653015597, 3873.825677844504, 3941.9211615767813, 4070.653994410479, 4101.323281658522, 125452.94076814041, 126107.99999999908, 126657.73342266552, 126802.36598816946, 127902.0, 11109.888901111048, 11370.715732106764, 11411.144164187719, 11434.656960291204, 11977.940110299567, 23371.0, 23623.409414764425, 23751.881240593688, 23792.643110353358, 23855.64216536753, 8027.438079334391, 8181.468204566803, 8236.546989915612, 8312.8753068704, 8391.874121888177, 4001.599840015975, 4322.265214913472, 4383.823214969446, 4527.773611319487, 4547.295169248771, 3348.0, 3393.1856354475244, 3429.7770644908, 3485.233248685285, 3487.9302413951577, 636.8821767972847, 643.469137961184, 643.9979392065901, 645.1484041065842, 667.396006614015, 555.2559570175983, 591.382005803936, 626.6334194496179, 654.0581562549913, 665.6139439125295, 7644.312011918954, 9104.499252541042, 9324.673636422693, 9335.159835614828, 9445.480498572508, 569.8717788497638, 594.402625361509, 649.6621756686496, 655.9163756161639, 681.4514315975687, 3563.4832949222737, 4264.530901600821, 4292.18448494785, 4474.753888536096, 4613.584777369986, 167964.0, 168945.0, 169232.0, 170664.0, 173791.0, 90383.09616903878, 90744.0, 128132.0, 150403.0, 153407.0, 93386.0, 122352.0, 125482.3725881383, 128794.0, 128922.35538822245, 8557.48655080697, 8859.955700221457, 8969.641214351353, 8977.730668079968, 9005.684801031932, 55849.162262566904, 63628.363716364096, 63850.0, 65314.0, 66720.0, 84203.15796841953, 93555.0, 97081.0, 101595.0, 104730.0, 11188.384638844942, 11396.0, 11435.656930291772, 11563.6530904073, 11766.411679416165, 12644.43100060481, 12672.366381681064, 12730.0, 13141.737165256833, 13163.802542961672, 11256.7748645025, 11595.072394208612, 11677.299362038304, 12446.315452650191, 12520.248785072925, 11724.296542207154, 11961.940190298992, 12433.502659893504, 12478.25130492137, 12532.937335313265, 11529.827052594386, 11853.288802671867, 12027.819582706441, 12402.937985310376, 12470.625881223577, 8770.166834150745, 9471.715848524555, 10062.547185376821, 10217.693469195936, 10396.688099357032, 8203.26170644621, 8823.764672945665, 9718.0, 10170.491475426346, 10174.338667986558], "value": 7713.064779088153, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1661.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 115.0, 105.0, 119.0, 96.0, 170.0, 100.0, 174.0, 172.0, 164.0], "value": 132.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 140.0, 141.0, 188.0, 140.0, 137.0, 129.0, 112.0, 179.0, 138.0], "value": 146.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [247.0, 255.0, 284.0, 271.0, 197.0, 198.0, 236.0, 211.0, 203.0, 199.0], "value": 230.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 100.0, 104.0, 179.0, 84.0, 59.0, 61.0, 61.0, 129.0, 58.0], "value": 90.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 73.0, 137.0, 98.0, 101.0, 107.0, 110.0, 73.0, 59.0, 102.0], "value": 92.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [91.0, 89.0, 133.0, 122.0, 89.0, 98.0, 119.0, 89.0, 91.0, 86.0], "value": 100.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 123.0, 148.0, 103.0, 148.0, 148.0, 103.0, 148.0, 109.0, 119.0], "value": 124.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 96.0, 78.0, 152.0, 143.0, 103.0, 84.0, 144.0, 151.0, 137.0], "value": 116.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 71.0, 63.0, 57.0, 58.0, 55.0, 57.0, 65.0, 72.0, 71.0], "value": 62.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 73.0, 70.0, 74.0, 75.0, 85.0, 74.0, 80.0, 102.0, 106.0], "value": 80.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 87.0, 85.0, 88.0, 85.0, 83.0, 85.0, 86.0, 89.0, 87.0], "value": 86.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 156.0, 151.0, 155.0, 141.0, 140.0, 142.0, 144.0, 164.0, 160.0], "value": 150.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 228.0, 176.0, 176.0, 166.0, 165.0, 168.0, 193.0, 195.0, 170.0], "value": 180.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 68.0, 67.0, 67.0, 68.0, 68.0, 68.0, 65.0, 67.0, 68.0], "value": 67.2, "unit": "score"}]}]} 05:57:01 INFO - Return code: 0 05:57:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:57:01 ERROR - # TBPL SUCCESS # 05:57:01 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:57:01 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:57:01 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:57:01 INFO - 2016-08-08 05:57:01.188 screenresolution[1679:10433] starting screenresolution argv=screenresolution get 05:57:01 INFO - 2016-08-08 05:57:01.191 screenresolution[1679:10433] Display 0: 1600x1200x32@60 05:57:01 INFO - 2016-08-08 05:57:01.196 screenresolution[1680:10436] starting screenresolution argv=screenresolution list 05:57:01 INFO - Available Modes on Display 0 05:57:01 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:57:01 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:57:01 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:57:01 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:57:01 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:57:01 INFO - Intel Iris: 05:57:01 INFO - Chipset Model: Intel Iris 05:57:01 INFO - Type: GPU 05:57:01 INFO - Bus: Built-In 05:57:01 INFO - VRAM (Dynamic, Max): 1536 MB 05:57:01 INFO - Vendor: Intel (0x8086) 05:57:01 INFO - Device ID: 0x0a2e 05:57:01 INFO - Revision ID: 0x0009 05:57:01 INFO - Displays: 05:57:01 INFO - Display: 05:57:01 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:57:01 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:57:01 INFO - Display Serial Number: 1600x1200 60 05:57:01 INFO - Main Display: Yes 05:57:01 INFO - Mirror: Off 05:57:01 INFO - Online: Yes 05:57:01 INFO - Rotation: Supported 05:57:01 INFO - Return code: 0 05:57:01 INFO - Running post-action listener: _resource_record_post_action 05:57:01 INFO - [mozharness: 2016-08-08 12:57:01.429365Z] Finished run-tests step (success) 05:57:01 INFO - Running post-run listener: _resource_record_post_run 05:57:01 INFO - Total resource usage - Wall time: 1213s; CPU: 54.0%; Read bytes: 39191552; Write bytes: 708171776; Read time: 400; Write time: 1904 05:57:01 INFO - TinderboxPrint: CPU usage
54.2% 05:57:01 INFO - TinderboxPrint: I/O read bytes / time
39,191,552 / 400 05:57:01 INFO - TinderboxPrint: I/O write bytes / time
708,171,776 / 1,904 05:57:01 INFO - TinderboxPrint: CPU idle
2,224.1 (45.8%) 05:57:01 INFO - TinderboxPrint: CPU system
979.4 (20.2%) 05:57:01 INFO - TinderboxPrint: CPU user
1,650.2 (34.0%) 05:57:01 INFO - TinderboxPrint: Swap in / out
445,767,680 / 0 05:57:01 INFO - install - Wall time: 36s; CPU: 55.0%; Read bytes: 396517888; Write bytes: 391251968; Read time: 30421; Write time: 701 05:57:01 INFO - run-tests - Wall time: 1178s; CPU: 54.0%; Read bytes: 37106688; Write bytes: 297054208; Read time: 373; Write time: 1162 05:57:01 INFO - Running post-run listener: _upload_blobber_files 05:57:01 INFO - Blob upload gear active. 05:57:01 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:57:01 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 05:57:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:57:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:57:02 INFO - (blobuploader) - INFO - Open directory for files ... 05:57:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:57:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:57:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:57:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:57:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:57:03 INFO - (blobuploader) - INFO - Done attempting. 05:57:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 05:57:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:57:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:57:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 05:57:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:57:04 INFO - (blobuploader) - INFO - Done attempting. 05:57:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:57:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:57:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:57:08 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:57:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:57:08 INFO - (blobuploader) - INFO - Done attempting. 05:57:08 INFO - (blobuploader) - INFO - Iteration through files over. 05:57:08 INFO - Return code: 0 05:57:08 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:57:08 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:57:08 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e0df51d88d26dff36695bfd3e5044e14228f105fdc7e247cf7c17087de707c6e78f9251ce1acc5dd2af79fc7fe473151e864cc1cc3605bf299bddb544a943b16", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/68c380a25077d0148b3c0f07304f460f31ddaf62646b7bbec976607d9a1d83d37300f5b7e5fa8bb9665c904549ce029cc051bb3801ccb2a7f3deed5b207b7d82", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f399b76035953269dc4169e1d606b55ef7c61546f2be5a54108794e1f7140f7859f14efbfd64fe9dfafa2fd593dd94823745cc6eb644cd31fad9f2743f834cf1"} 05:57:08 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:57:08 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:57:08 INFO - Contents: 05:57:08 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e0df51d88d26dff36695bfd3e5044e14228f105fdc7e247cf7c17087de707c6e78f9251ce1acc5dd2af79fc7fe473151e864cc1cc3605bf299bddb544a943b16", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/68c380a25077d0148b3c0f07304f460f31ddaf62646b7bbec976607d9a1d83d37300f5b7e5fa8bb9665c904549ce029cc051bb3801ccb2a7f3deed5b207b7d82", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f399b76035953269dc4169e1d606b55ef7c61546f2be5a54108794e1f7140f7859f14efbfd64fe9dfafa2fd593dd94823745cc6eb644cd31fad9f2743f834cf1"} 05:57:08 INFO - Running post-run listener: copy_logs_to_upload_dir 05:57:08 INFO - Copying logs to upload dir... 05:57:08 INFO - mkdir: /builds/slave/test/build/upload/logs 05:57:08 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1269.678177 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-08-08 05:57:08.158463) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-08 05:57:08.162002) ========= 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.24v1Ola66r/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.UB4q0bazmy/Listeners TMPDIR=/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e0df51d88d26dff36695bfd3e5044e14228f105fdc7e247cf7c17087de707c6e78f9251ce1acc5dd2af79fc7fe473151e864cc1cc3605bf299bddb544a943b16", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/68c380a25077d0148b3c0f07304f460f31ddaf62646b7bbec976607d9a1d83d37300f5b7e5fa8bb9665c904549ce029cc051bb3801ccb2a7f3deed5b207b7d82", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f399b76035953269dc4169e1d606b55ef7c61546f2be5a54108794e1f7140f7859f14efbfd64fe9dfafa2fd593dd94823745cc6eb644cd31fad9f2743f834cf1"} build_url:https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010887 build_url: 'https://queue.taskcluster.net/v1/task/NpD1PBiKS0aQKRn7OTXS-Q/artifacts/public/build/firefox-51.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e0df51d88d26dff36695bfd3e5044e14228f105fdc7e247cf7c17087de707c6e78f9251ce1acc5dd2af79fc7fe473151e864cc1cc3605bf299bddb544a943b16", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/68c380a25077d0148b3c0f07304f460f31ddaf62646b7bbec976607d9a1d83d37300f5b7e5fa8bb9665c904549ce029cc051bb3801ccb2a7f3deed5b207b7d82", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f399b76035953269dc4169e1d606b55ef7c61546f2be5a54108794e1f7140f7859f14efbfd64fe9dfafa2fd593dd94823745cc6eb644cd31fad9f2743f834cf1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-08 05:57:08.194074) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-08 05:57:08.194372) ========= 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.24v1Ola66r/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.UB4q0bazmy/Listeners TMPDIR=/var/folders/r9/65qs5nfd3vb9c3mfq0_swnf400000w/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.005151 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-08 05:57:08.242474) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-08 05:57:08.242965) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-08 05:57:08.243336) ========= ========= Total master_lag: 0.95 =========