builder: mozilla-beta_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0294 starttime: 1467825366.28 results: success (0) buildid: 20160706073523 builduid: c28e067fd6254dbbbe742961c22d611d revision: 85f50dde3d351d93b571ac49ff71cf5140a2a3a7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:06.279050) ========= master: http://buildbot-master132.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:06.279490) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:06.279779) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:06.304583) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:06.304904) ========= 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.77VrDODGrV/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.TXBqktLF78/Listeners TMPDIR=/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/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-07-06 10:16:06-- 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% 135M=0s 2016-07-06 10:16:06 (135 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.092797 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:06.420080) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:06.420397) ========= 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.77VrDODGrV/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.TXBqktLF78/Listeners TMPDIR=/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/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.025675 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:06.469534) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-06 10:16:06.469912) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 85f50dde3d351d93b571ac49ff71cf5140a2a3a7 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 85f50dde3d351d93b571ac49ff71cf5140a2a3a7 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.77VrDODGrV/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.TXBqktLF78/Listeners TMPDIR=/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/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-07-06 10:16:06,549 truncating revision to first 12 chars 2016-07-06 10:16:06,549 Setting DEBUG logging. 2016-07-06 10:16:06,549 attempt 1/10 2016-07-06 10:16:06,549 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/85f50dde3d35?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-06 10:16:07,540 unpacking tar archive at: mozilla-beta-85f50dde3d35/testing/mozharness/ program finished with exit code 0 elapsedTime=1.267490 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-06 10:16:07.763125) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:07.763943) ========= script_repo_revision: 85f50dde3d351d93b571ac49ff71cf5140a2a3a7 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:07.764916) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:07.765631) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-06 10:16:07.785093) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-07-06 10:16:07.785812) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 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', 'Mozilla-Beta', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.77VrDODGrV/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.TXBqktLF78/Listeners TMPDIR=/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 10:16:07 INFO - MultiFileLogger online at 20160706 10:16:07 in /builds/slave/test 10:16:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 10:16:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:16:07 INFO - {'append_to_log': False, 10:16:07 INFO - 'base_work_dir': '/builds/slave/test', 10:16:07 INFO - 'blob_upload_branch': 'Mozilla-Beta', 10:16:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:16:07 INFO - 'branch': 'Mozilla-Beta', 10:16:07 INFO - 'buildbot_json_path': 'buildprops.json', 10:16:07 INFO - 'config_files': ('talos/mac_config.py',), 10:16:07 INFO - 'default_actions': ('clobber', 10:16:07 INFO - 'read-buildbot-config', 10:16:07 INFO - 'download-and-extract', 10:16:07 INFO - 'populate-webroot', 10:16:07 INFO - 'create-virtualenv', 10:16:07 INFO - 'install', 10:16:07 INFO - 'run-tests'), 10:16:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:16:07 INFO - 'download_minidump_stackwalk': True, 10:16:07 INFO - 'download_symbols': 'ondemand', 10:16:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:16:07 INFO - 'tooltool.py': '/tools/tooltool.py', 10:16:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:16:07 INFO - '/tools/misc-python/virtualenv.py')}, 10:16:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:16:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:16:07 INFO - 'installer_path': 'installer.exe', 10:16:07 INFO - 'log_level': 'info', 10:16:07 INFO - 'log_name': 'talos', 10:16:07 INFO - 'log_to_console': True, 10:16:07 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 10:16:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 10:16:07 INFO - 'opt_config_files': (), 10:16:07 INFO - 'pip_index': False, 10:16:07 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:16:07 INFO - 'cmd': ('bash', 10:16:07 INFO - '-c', 10:16:07 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:16:07 INFO - 'enabled': True, 10:16:07 INFO - 'halt_on_failure': False, 10:16:07 INFO - 'name': 'check_screen_resolution'},), 10:16:07 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:16:07 INFO - 'cmd': ('bash', 10:16:07 INFO - '-c', 10:16:07 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:16:07 INFO - 'enabled': True, 10:16:07 INFO - 'halt_on_failure': False, 10:16:07 INFO - 'name': 'check_screen_resolution'},), 10:16:07 INFO - 'run_cmd_checks_enabled': True, 10:16:07 INFO - 'sps_profile': False, 10:16:07 INFO - 'sps_profile_interval': 0, 10:16:07 INFO - 'suite': 'dromaeojs-e10s', 10:16:07 INFO - 'system_bits': '32', 10:16:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:16:07 INFO - 'title': 't-yosemite-r7-0294', 10:16:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:16:07 INFO - 'use_talos_json': True, 10:16:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:16:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:16:07 INFO - 'work_dir': 'build'} 10:16:07 INFO - ##### 10:16:07 INFO - ##### Running clobber step. 10:16:07 INFO - ##### 10:16:07 INFO - Running pre-action listener: _resource_record_pre_action 10:16:07 INFO - Running main action method: clobber 10:16:07 INFO - rmtree: /builds/slave/test/build 10:16:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:16:09 INFO - Running post-action listener: _resource_record_post_action 10:16:09 INFO - ##### 10:16:09 INFO - ##### Running read-buildbot-config step. 10:16:09 INFO - ##### 10:16:09 INFO - Running pre-action listener: _resource_record_pre_action 10:16:09 INFO - Running main action method: read_buildbot_config 10:16:09 INFO - Using buildbot properties: 10:16:09 INFO - { 10:16:09 INFO - "project": "", 10:16:09 INFO - "product": "firefox", 10:16:09 INFO - "script_repo_revision": "production", 10:16:09 INFO - "builddir": "mozilla-beta_yosemite_r7_test-dromaeojs-e10s", 10:16:09 INFO - "repository": "", 10:16:09 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-beta talos dromaeojs-e10s", 10:16:09 INFO - "buildid": "20160706073523", 10:16:09 INFO - "pgo_build": "False", 10:16:09 INFO - "basedir": "/builds/slave/test", 10:16:09 INFO - "buildnumber": 22, 10:16:09 INFO - "slavename": "t-yosemite-r7-0294", 10:16:09 INFO - "master": "http://buildbot-master132.bb.releng.scl3.mozilla.com:8201/", 10:16:09 INFO - "platform": "yosemite_r7", 10:16:09 INFO - "scheduler": "tests-mozilla-beta-macosx64-talos", 10:16:09 INFO - "branch": "mozilla-beta", 10:16:09 INFO - "repo_path": "releases/mozilla-beta", 10:16:09 INFO - "revision": "85f50dde3d351d93b571ac49ff71cf5140a2a3a7", 10:16:09 INFO - "stage_platform": "macosx64", 10:16:09 INFO - "builduid": "c28e067fd6254dbbbe742961c22d611d", 10:16:09 INFO - "slavebuilddir": "test" 10:16:09 INFO - } 10:16:09 INFO - Found installer url https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg. 10:16:09 INFO - Running post-action listener: _resource_record_post_action 10:16:09 INFO - ##### 10:16:09 INFO - ##### Running download-and-extract step. 10:16:09 INFO - ##### 10:16:09 INFO - Running pre-action listener: _resource_record_pre_action 10:16:09 INFO - Running main action method: download_and_extract 10:16:09 INFO - mkdir: /builds/slave/test/build/tests 10:16:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:09 INFO - https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.test_packages.json matches https://queue.taskcluster.net 10:16:09 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.test_packages.json 10:16:09 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.test_packages.json 10:16:09 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-48.0.en-US.mac.test_packages.json 10:16:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0.en-US.mac.test_packages.json'}, attempt #1 10:16:11 INFO - Downloaded 1165 bytes. 10:16:11 INFO - Reading from file /builds/slave/test/build/firefox-48.0.en-US.mac.test_packages.json 10:16:11 INFO - Using the following test package requirements: 10:16:11 INFO - {u'common': [u'firefox-48.0.en-US.mac.common.tests.zip'], 10:16:11 INFO - u'cppunittest': [u'firefox-48.0.en-US.mac.common.tests.zip', 10:16:11 INFO - u'firefox-48.0.en-US.mac.cppunittest.tests.zip'], 10:16:11 INFO - u'gtest': [u'firefox-48.0.en-US.mac.common.tests.zip', 10:16:11 INFO - u'firefox-48.0.en-US.mac.gtest.tests.zip'], 10:16:11 INFO - u'jittest': [u'firefox-48.0.en-US.mac.common.tests.zip', u'jsshell-mac.zip'], 10:16:11 INFO - u'mochitest': [u'firefox-48.0.en-US.mac.common.tests.zip', 10:16:11 INFO - u'firefox-48.0.en-US.mac.mochitest.tests.zip'], 10:16:11 INFO - u'mozbase': [u'firefox-48.0.en-US.mac.common.tests.zip'], 10:16:11 INFO - u'reftest': [u'firefox-48.0.en-US.mac.common.tests.zip', 10:16:11 INFO - u'firefox-48.0.en-US.mac.reftest.tests.zip'], 10:16:11 INFO - u'talos': [u'firefox-48.0.en-US.mac.common.tests.zip', 10:16:11 INFO - u'firefox-48.0.en-US.mac.talos.tests.zip'], 10:16:11 INFO - u'web-platform': [u'firefox-48.0.en-US.mac.common.tests.zip', 10:16:11 INFO - u'firefox-48.0.en-US.mac.web-platform.tests.zip'], 10:16:11 INFO - u'xpcshell': [u'firefox-48.0.en-US.mac.common.tests.zip', 10:16:11 INFO - u'firefox-48.0.en-US.mac.xpcshell.tests.zip']} 10:16:11 INFO - Downloading packages: [u'firefox-48.0.en-US.mac.common.tests.zip'] for test suite category: common 10:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:11 INFO - https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 10:16:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip 10:16:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip 10:16:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.mac.common.tests.zip 10:16:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.mac.common.tests.zip'}, attempt #1 10:16:12 INFO - Downloaded 18351403 bytes. 10:16:12 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:16:12 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 10:16:15 INFO - Return code: 0 10:16:15 INFO - Downloading packages: [u'firefox-48.0.en-US.mac.common.tests.zip', u'firefox-48.0.en-US.mac.talos.tests.zip'] for test suite category: talos 10:16:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:15 INFO - https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 10:16:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip 10:16:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip 10:16:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.mac.common.tests.zip 10:16:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.mac.common.tests.zip'}, attempt #1 10:16:16 INFO - Downloaded 18351403 bytes. 10:16:16 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:16:16 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 10:16:20 INFO - Return code: 0 10:16:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:20 INFO - https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 10:16:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.talos.tests.zip 10:16:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.talos.tests.zip 10:16:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.mac.talos.tests.zip 10:16:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.mac.talos.tests.zip'}, attempt #1 10:16:21 INFO - Downloaded 10840145 bytes. 10:16:21 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:16:21 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 10:16:21 INFO - Return code: 0 10:16:21 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:21 INFO - https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg matches https://queue.taskcluster.net 10:16:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg 10:16:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg 10:16:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg to /builds/slave/test/build/firefox-48.0.en-US.mac.dmg 10:16:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-48.0.en-US.mac.dmg'}, attempt #1 10:16:23 INFO - Downloaded 86188259 bytes. 10:16:23 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg 10:16:23 INFO - mkdir: /builds/slave/test/properties 10:16:23 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:16:23 INFO - Writing to file /builds/slave/test/properties/build_url 10:16:23 INFO - Contents: 10:16:23 INFO - build_url:https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg 10:16:24 INFO - Running post-action listener: _resource_record_post_action 10:16:24 INFO - Running post-action listener: set_extra_try_arguments 10:16:24 INFO - ##### 10:16:24 INFO - ##### Running populate-webroot step. 10:16:24 INFO - ##### 10:16:24 INFO - Running pre-action listener: _resource_record_pre_action 10:16:24 INFO - Running main action method: populate_webroot 10:16:24 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:16:24 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:16:24 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:16:24 INFO - '--tppagecycles', 10:16:24 INFO - '7'], 10:16:24 INFO - 'tests': ['tsvgm']}}, 10:16:24 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:16:24 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:16:24 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:16:24 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:16:24 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:24 INFO - 'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:16:24 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:16:24 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:24 INFO - 'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['damp', 'tps']}, 10:16:24 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:24 INFO - 'tests': ['damp', 'tps']}, 10:16:24 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['dromaeo_dom']}, 10:16:24 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:16:24 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['a11yr', 10:16:24 INFO - 'ts_paint', 10:16:24 INFO - 'tpaint', 10:16:24 INFO - 'sessionrestore', 10:16:24 INFO - 'sessionrestore_no_auto_restore', 10:16:24 INFO - 'tabpaint']}, 10:16:24 INFO - 'other-e10s': {'tests': ['a11yr', 10:16:24 INFO - 'ts_paint', 10:16:24 INFO - 'tpaint', 10:16:24 INFO - 'sessionrestore', 10:16:24 INFO - 'sessionrestore_no_auto_restore', 10:16:24 INFO - 'tabpaint']}, 10:16:24 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:16:24 INFO - 'ts_paint', 10:16:24 INFO - 'tpaint', 10:16:24 INFO - 'sessionrestore', 10:16:24 INFO - 'sessionrestore_no_auto_restore', 10:16:24 INFO - 'tabpaint']}, 10:16:24 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:16:24 INFO - 'ts_paint', 10:16:24 INFO - 'tpaint', 10:16:24 INFO - 'sessionrestore', 10:16:24 INFO - 'sessionrestore_no_auto_restore', 10:16:24 INFO - 'tabpaint']}, 10:16:24 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['a11yr', 10:16:24 INFO - 'ts_paint', 10:16:24 INFO - 'tpaint', 10:16:24 INFO - 'sessionrestore', 10:16:24 INFO - 'sessionrestore_no_auto_restore', 10:16:24 INFO - 'tabpaint']}, 10:16:24 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['a11yr', 10:16:24 INFO - 'ts_paint', 10:16:24 INFO - 'tpaint', 10:16:24 INFO - 'sessionrestore', 10:16:24 INFO - 'sessionrestore_no_auto_restore', 10:16:24 INFO - 'tabpaint']}, 10:16:24 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['tsvgx', 10:16:24 INFO - 'tsvgr_opacity', 10:16:24 INFO - 'tart', 10:16:24 INFO - 'tscrollx', 10:16:24 INFO - 'cart']}, 10:16:24 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:16:24 INFO - 'tsvgr_opacity', 10:16:24 INFO - 'tart', 10:16:24 INFO - 'tscrollx', 10:16:24 INFO - 'cart']}, 10:16:24 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:24 INFO - 'talos_options': ['--disable-e10s'], 10:16:24 INFO - 'tests': ['tp5o']}, 10:16:24 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:24 INFO - 'tests': ['tp5o']}, 10:16:24 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:24 INFO - 'talos_options': ['--disable-e10s', 10:16:24 INFO - '--xperf_path', 10:16:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:16:24 INFO - 'tests': ['tp5n']}, 10:16:24 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:24 INFO - 'talos_options': ['--xperf_path', 10:16:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:16:24 INFO - 'tests': ['tp5n']}}, 10:16:24 INFO - 'talos.zip': {'path': '', 10:16:24 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:16:24 INFO - Running post-action listener: _resource_record_post_action 10:16:24 INFO - ##### 10:16:24 INFO - ##### Running create-virtualenv step. 10:16:24 INFO - ##### 10:16:24 INFO - Running pre-action listener: _resource_record_pre_action 10:16:24 INFO - Running main action method: create_virtualenv 10:16:24 INFO - Creating virtualenv /builds/slave/test/build/venv 10:16:24 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 10:16:24 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:16:24 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:16:24 INFO - Using real prefix '/tools/python27' 10:16:24 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:16:25 INFO - Installing distribute.............................................................................................................................................................................................done. 10:16:28 INFO - Installing pip.................done. 10:16:28 INFO - Return code: 0 10:16:28 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16: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', 'pip>=1.5'] in /builds/slave/test/build 10:16: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 pip>=1.5 10:16:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:28 INFO - 'HOME': '/Users/cltbld', 10:16:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:28 INFO - 'LOGNAME': 'cltbld', 10:16:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:28 INFO - 'MOZ_NO_REMOTE': '1', 10:16:28 INFO - 'NO_EM_RESTART': '1', 10:16:28 INFO - 'PAGER': '/bin/cat', 10:16:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:28 INFO - 'PWD': '/builds/slave/test', 10:16:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:28 INFO - 'SHELL': '/bin/bash', 10:16:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:28 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:28 INFO - 'USER': 'cltbld', 10:16:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:28 INFO - 'XPC_FLAGS': '0x0', 10:16:28 INFO - 'XPC_SERVICE_NAME': '0', 10:16:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:28 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 10:16:28 INFO - Cleaning up... 10:16:28 INFO - Return code: 0 10:16:28 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 10:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16: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', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16: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', 'psutil>=0.7.1'] in /builds/slave/test/build 10:16: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 psutil>=0.7.1 10:16:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:28 INFO - 'HOME': '/Users/cltbld', 10:16:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:28 INFO - 'LOGNAME': 'cltbld', 10:16:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:28 INFO - 'MOZ_NO_REMOTE': '1', 10:16:28 INFO - 'NO_EM_RESTART': '1', 10:16:28 INFO - 'PAGER': '/bin/cat', 10:16:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:28 INFO - 'PWD': '/builds/slave/test', 10:16:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:28 INFO - 'SHELL': '/bin/bash', 10:16:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:28 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:28 INFO - 'USER': 'cltbld', 10:16:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:28 INFO - 'XPC_FLAGS': '0x0', 10:16:28 INFO - 'XPC_SERVICE_NAME': '0', 10:16:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:28 INFO - Downloading/unpacking psutil>=0.7.1 10:16:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:16:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:16:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:16:31 INFO - Installing collected packages: psutil 10:16:31 INFO - Running setup.py install for psutil 10:16:31 INFO - building 'psutil._psutil_osx' extension 10:16:31 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 10:16:32 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 10:16:32 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 10:16:32 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 10:16:32 INFO - building 'psutil._psutil_posix' extension 10:16:32 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 10:16:32 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 10:16:32 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 10:16:32 INFO - ^ 10:16:32 INFO - 1 warning generated. 10:16:32 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 10:16:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:16:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:16:32 INFO - Successfully installed psutil 10:16:32 INFO - Cleaning up... 10:16:32 INFO - Return code: 0 10:16:32 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 10:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:33 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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16:33 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.0.0'] in /builds/slave/test/build 10:16:33 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.0.0 10:16:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:33 INFO - 'HOME': '/Users/cltbld', 10:16:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:33 INFO - 'LOGNAME': 'cltbld', 10:16:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:33 INFO - 'MOZ_NO_REMOTE': '1', 10:16:33 INFO - 'NO_EM_RESTART': '1', 10:16:33 INFO - 'PAGER': '/bin/cat', 10:16:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:33 INFO - 'PWD': '/builds/slave/test', 10:16:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:33 INFO - 'SHELL': '/bin/bash', 10:16:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:33 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:33 INFO - 'USER': 'cltbld', 10:16:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:33 INFO - 'XPC_FLAGS': '0x0', 10:16:33 INFO - 'XPC_SERVICE_NAME': '0', 10:16:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:33 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 10:16:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:35 INFO - Downloading mozsystemmonitor-0.0.tar.gz 10:16:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:16:35 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 10:16:35 INFO - Installing collected packages: mozsystemmonitor 10:16:35 INFO - Running setup.py install for mozsystemmonitor 10:16:35 INFO - Successfully installed mozsystemmonitor 10:16:35 INFO - Cleaning up... 10:16:35 INFO - Return code: 0 10:16:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:16:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:35 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 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:16:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:16:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:35 INFO - 'HOME': '/Users/cltbld', 10:16:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:35 INFO - 'LOGNAME': 'cltbld', 10:16:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:35 INFO - 'MOZ_NO_REMOTE': '1', 10:16:35 INFO - 'NO_EM_RESTART': '1', 10:16:35 INFO - 'PAGER': '/bin/cat', 10:16:35 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:35 INFO - 'PWD': '/builds/slave/test', 10:16:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:35 INFO - 'SHELL': '/bin/bash', 10:16:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:35 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:35 INFO - 'USER': 'cltbld', 10:16:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:35 INFO - 'XPC_FLAGS': '0x0', 10:16:35 INFO - 'XPC_SERVICE_NAME': '0', 10:16:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:36 INFO - Downloading/unpacking blobuploader==1.2.4 10:16:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:38 INFO - Downloading blobuploader-1.2.4.tar.gz 10:16:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:16:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:16:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:16:39 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:16:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:39 INFO - Downloading docopt-0.6.1.tar.gz 10:16:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:16:39 INFO - Installing collected packages: blobuploader, requests, docopt 10:16:39 INFO - Running setup.py install for blobuploader 10:16:40 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:16:40 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:16:40 INFO - Running setup.py install for requests 10:16:40 INFO - Running setup.py install for docopt 10:16:40 INFO - Successfully installed blobuploader requests docopt 10:16:40 INFO - Cleaning up... 10:16:40 INFO - Return code: 0 10:16:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:16:40 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:40 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:40 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 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 10:16:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:16:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:40 INFO - 'HOME': '/Users/cltbld', 10:16:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:40 INFO - 'LOGNAME': 'cltbld', 10:16:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:40 INFO - 'MOZ_NO_REMOTE': '1', 10:16:40 INFO - 'NO_EM_RESTART': '1', 10:16:40 INFO - 'PAGER': '/bin/cat', 10:16:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:40 INFO - 'PWD': '/builds/slave/test', 10:16:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:40 INFO - 'SHELL': '/bin/bash', 10:16:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:40 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:40 INFO - 'USER': 'cltbld', 10:16:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:40 INFO - 'XPC_FLAGS': '0x0', 10:16:40 INFO - 'XPC_SERVICE_NAME': '0', 10:16:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-lob6wr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-7vJq2L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-xmPPv2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-pIwAIm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-TMuP5k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-pwmGER-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-lurmKD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-xxv2jJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:16:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:16:41 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-QVupz9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:16:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:16:42 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-9bMnaD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:16:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:16:42 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-yEAsh9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:16:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:16:42 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-gW4wwE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:16:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:16:42 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-Qbv8Gz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:16:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:16:42 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-TenEsM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:16:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:16:42 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-bj13Ha-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:16:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:16:42 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-VLdzxA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:16:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:16:42 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-2LfKUa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:16:42 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:16:42 INFO - Running setup.py install for manifestparser 10:16:42 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:16:42 INFO - Running setup.py install for mozcrash 10:16:43 INFO - Running setup.py install for mozdebug 10:16:43 INFO - Running setup.py install for mozdevice 10:16:43 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:16:43 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:16:43 INFO - Running setup.py install for mozfile 10:16:43 INFO - Running setup.py install for mozhttpd 10:16:43 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:16:43 INFO - Running setup.py install for mozinfo 10:16:43 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:16:43 INFO - Running setup.py install for mozInstall 10:16:43 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:16:43 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:16:43 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:16:43 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:16:43 INFO - Running setup.py install for mozleak 10:16:44 INFO - Running setup.py install for mozlog 10:16:44 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:16:44 INFO - Running setup.py install for moznetwork 10:16:44 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:16:44 INFO - Running setup.py install for mozprocess 10:16:44 INFO - Running setup.py install for mozprofile 10:16:44 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:16:44 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:16:44 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:16:44 INFO - Running setup.py install for mozrunner 10:16:44 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:16:44 INFO - Running setup.py install for mozscreenshot 10:16:45 INFO - Running setup.py install for moztest 10:16:45 INFO - Running setup.py install for mozversion 10:16:45 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:16:45 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:16:45 INFO - Cleaning up... 10:16:45 INFO - Return code: 0 10:16:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:16:45 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:45 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:45 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 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 10:16:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:16:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:45 INFO - 'HOME': '/Users/cltbld', 10:16:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:45 INFO - 'LOGNAME': 'cltbld', 10:16:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:45 INFO - 'MOZ_NO_REMOTE': '1', 10:16:45 INFO - 'NO_EM_RESTART': '1', 10:16:45 INFO - 'PAGER': '/bin/cat', 10:16:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:45 INFO - 'PWD': '/builds/slave/test', 10:16:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:45 INFO - 'SHELL': '/bin/bash', 10:16:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:45 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:45 INFO - 'USER': 'cltbld', 10:16:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:45 INFO - 'XPC_FLAGS': '0x0', 10:16:45 INFO - 'XPC_SERVICE_NAME': '0', 10:16:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:16:45 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-o3pJZb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:16:45 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 10:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:16:45 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-BM9sn0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:16:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:16:45 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-ZRCOUC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:16:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:16:45 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-y_VlrW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-x7JjpS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-7r_S2x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-lGUCWO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-ITzVEs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-oC0eu3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-ZJwK4Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-hIP4hQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-yJFCU7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:16:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 10:16:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:16:46 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-MKGLLz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 10:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:16:47 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-c7moUI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 10:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:16:47 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-yyV8Yl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 10:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:16:47 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-MAMdg0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 10:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:16:47 INFO - Running setup.py (path:/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/pip-SGu28z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:16:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:16:47 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:16:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:49 INFO - Downloading blessings-1.6.tar.gz 10:16:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:16:50 INFO - Installing collected packages: blessings 10:16:50 INFO - Running setup.py install for blessings 10:16:50 INFO - Successfully installed blessings 10:16:50 INFO - Cleaning up... 10:16:50 INFO - Return code: 0 10:16:50 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:16:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:16:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:16:50 INFO - Reading from file tmpfile_stdout 10:16:50 INFO - Current package versions: 10:16:50 INFO - blessings == 1.6 10:16:50 INFO - blobuploader == 1.2.4 10:16:50 INFO - docopt == 0.6.1 10:16:50 INFO - manifestparser == 1.1 10:16:50 INFO - mozInstall == 1.12 10:16:50 INFO - mozcrash == 0.17 10:16:50 INFO - mozdebug == 0.1 10:16:50 INFO - mozdevice == 0.48 10:16:50 INFO - mozfile == 1.2 10:16:50 INFO - mozhttpd == 0.7 10:16:50 INFO - mozinfo == 0.9 10:16:50 INFO - mozleak == 0.1 10:16:50 INFO - mozlog == 3.1 10:16:50 INFO - moznetwork == 0.27 10:16:50 INFO - mozprocess == 0.22 10:16:50 INFO - mozprofile == 0.28 10:16:50 INFO - mozrunner == 6.11 10:16:50 INFO - mozscreenshot == 0.1 10:16:50 INFO - mozsystemmonitor == 0.0 10:16:50 INFO - moztest == 0.7 10:16:50 INFO - mozversion == 1.4 10:16:50 INFO - psutil == 3.1.1 10:16:50 INFO - requests == 1.2.3 10:16:50 INFO - wsgiref == 0.1.2 10:16:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:16:50 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:50 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:50 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 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 10:16:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:16:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:50 INFO - 'HOME': '/Users/cltbld', 10:16:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:50 INFO - 'LOGNAME': 'cltbld', 10:16:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:50 INFO - 'MOZ_NO_REMOTE': '1', 10:16:50 INFO - 'NO_EM_RESTART': '1', 10:16:50 INFO - 'PAGER': '/bin/cat', 10:16:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:50 INFO - 'PWD': '/builds/slave/test', 10:16:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:50 INFO - 'SHELL': '/bin/bash', 10:16:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:50 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:50 INFO - 'USER': 'cltbld', 10:16:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:50 INFO - 'XPC_FLAGS': '0x0', 10:16:50 INFO - 'XPC_SERVICE_NAME': '0', 10:16:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:16:50 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:16:50 INFO - Cleaning up... 10:16:50 INFO - Return code: 0 10:16:50 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:16:50 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:50 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:50 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 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 10:16:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 10:16:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:50 INFO - 'HOME': '/Users/cltbld', 10:16:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:50 INFO - 'LOGNAME': 'cltbld', 10:16:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:50 INFO - 'MOZ_NO_REMOTE': '1', 10:16:50 INFO - 'NO_EM_RESTART': '1', 10:16:50 INFO - 'PAGER': '/bin/cat', 10:16:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:50 INFO - 'PWD': '/builds/slave/test', 10:16:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:50 INFO - 'SHELL': '/bin/bash', 10:16:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:50 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:50 INFO - 'USER': 'cltbld', 10:16:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:50 INFO - 'XPC_FLAGS': '0x0', 10:16:50 INFO - 'XPC_SERVICE_NAME': '0', 10:16:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:51 INFO - Downloading/unpacking jsonschema 10:16:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:53 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:16:53 INFO - Downloading/unpacking functools32 (from jsonschema) 10:16:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:53 INFO - Downloading functools32-3.2.3-2.tar.gz 10:16:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:16:54 INFO - warning: no files found matching '*.txt' 10:16:54 INFO - no previously-included directories found matching 'build' 10:16:54 INFO - no previously-included directories found matching 'dist' 10:16:54 INFO - no previously-included directories found matching '.git*' 10:16:54 INFO - Installing collected packages: jsonschema, functools32 10:16:54 INFO - Running setup.py install for functools32 10:16:54 INFO - warning: no files found matching '*.txt' 10:16:54 INFO - no previously-included directories found matching 'build' 10:16:54 INFO - no previously-included directories found matching 'dist' 10:16:54 INFO - no previously-included directories found matching '.git*' 10:16:54 INFO - Successfully installed jsonschema functools32 10:16:54 INFO - Cleaning up... 10:16:54 INFO - Return code: 0 10:16:54 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 10:16:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:54 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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1066d3a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1066e3420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8ab35aa690>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, '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.77VrDODGrV/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.TXBqktLF78/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 10:16:54 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', 'flake8'] in /builds/slave/test/build 10:16:54 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 flake8 10:16:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:16:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:16:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:16:54 INFO - 'HOME': '/Users/cltbld', 10:16:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:16:54 INFO - 'LOGNAME': 'cltbld', 10:16:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:54 INFO - 'MOZ_NO_REMOTE': '1', 10:16:54 INFO - 'NO_EM_RESTART': '1', 10:16:54 INFO - 'PAGER': '/bin/cat', 10:16:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:16:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:54 INFO - 'PWD': '/builds/slave/test', 10:16:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:16:54 INFO - 'SHELL': '/bin/bash', 10:16:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:16:54 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:16:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:16:54 INFO - 'USER': 'cltbld', 10:16:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:16:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:16:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:54 INFO - 'XPC_FLAGS': '0x0', 10:16:54 INFO - 'XPC_SERVICE_NAME': '0', 10:16:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:16:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:54 INFO - Downloading/unpacking flake8 10:16:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:57 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 10:16:57 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 10:16:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:58 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 10:16:58 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 10:16:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:58 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 10:16:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 10:16:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:16:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:16:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:16:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:16:59 INFO - no previously-included directories found matching 'docs/_build' 10:16:59 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 10:16:59 INFO - Running setup.py install for pep8 10:16:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:16:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:16:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:16:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:16:59 INFO - no previously-included directories found matching 'docs/_build' 10:16:59 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 10:16:59 INFO - Successfully installed flake8 mccabe pyflakes pep8 10:16:59 INFO - Cleaning up... 10:16:59 INFO - Return code: 0 10:16:59 INFO - Running post-action listener: _resource_record_post_action 10:16:59 INFO - Running post-action listener: _start_resource_monitoring 10:16:59 INFO - Starting resource monitoring. 10:16:59 INFO - ##### 10:16:59 INFO - ##### Running install step. 10:16:59 INFO - ##### 10:16:59 INFO - Running pre-action listener: _resource_record_pre_action 10:16:59 INFO - Running main action method: install 10:16:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:16:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:16:59 INFO - Reading from file tmpfile_stdout 10:16:59 INFO - Detecting whether we're running mozinstall >=1.0... 10:16:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:16:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:16:59 INFO - Reading from file tmpfile_stdout 10:16:59 INFO - Output received: 10:16:59 INFO - Usage: mozinstall [options] installer 10:16:59 INFO - Options: 10:16:59 INFO - -h, --help show this help message and exit 10:16:59 INFO - -d DEST, --destination=DEST 10:16:59 INFO - Directory to install application into. [default: 10:16:59 INFO - "/builds/slave/test"] 10:16:59 INFO - --app=APP Application being installed. [default: firefox] 10:16:59 INFO - mkdir: /builds/slave/test/build/application 10:16:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 10:16:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0.en-US.mac.dmg --destination /builds/slave/test/build/application 10:17:21 INFO - Reading from file tmpfile_stdout 10:17:21 INFO - Output received: 10:17:21 INFO - /builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox 10:17:21 INFO - Running post-action listener: _resource_record_post_action 10:17:21 INFO - ##### 10:17:21 INFO - ##### Running run-tests step. 10:17:21 INFO - ##### 10:17:21 INFO - Running pre-action listener: _resource_record_pre_action 10:17:21 INFO - Running main action method: run_tests 10:17:21 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:17:21 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:17:21 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:17:21 INFO - 2016-07-06 10:17:21.890 screenresolution[1640:7940] starting screenresolution argv=screenresolution get 10:17:21 INFO - 2016-07-06 10:17:21.893 screenresolution[1640:7940] Display 0: 1600x1200x32@60 10:17:21 INFO - 2016-07-06 10:17:21.899 screenresolution[1641:7942] starting screenresolution argv=screenresolution list 10:17:21 INFO - Available Modes on Display 0 10:17:21 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:17:21 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:17:21 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:17:21 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:17:22 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:17:22 INFO - Intel Iris: 10:17:22 INFO - Chipset Model: Intel Iris 10:17:22 INFO - Type: GPU 10:17:22 INFO - Bus: Built-In 10:17:22 INFO - VRAM (Dynamic, Max): 1536 MB 10:17:22 INFO - Vendor: Intel (0x8086) 10:17:22 INFO - Device ID: 0x0a2e 10:17:22 INFO - Revision ID: 0x0009 10:17:22 INFO - Displays: 10:17:22 INFO - Display: 10:17:22 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:17:22 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:17:22 INFO - Display Serial Number: 1600x1200 60 10:17:22 INFO - Main Display: Yes 10:17:22 INFO - Mirror: Off 10:17:22 INFO - Online: Yes 10:17:22 INFO - Rotation: Supported 10:17:22 INFO - Return code: 0 10:17:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:17:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:17:22 INFO - Python 2.7.3 10:17:22 INFO - Return code: 0 10:17:22 INFO - grabbing minidump binary from tooltool 10:17:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:17:22 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106572e00>, '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 0x1063dbdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10656db20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:17:22 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 10:17:22 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 10:17:22 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:17:22 INFO - Return code: 0 10:17:22 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 10:17:22 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:17:22 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:17:22 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 10:17:22 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:17:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 10:17:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 10:17:23 INFO - Return code: 0 10:17:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0294', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 10:17:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0294 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 10:17:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.77VrDODGrV/Render', 10:17:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:17:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:17:23 INFO - 'HOME': '/Users/cltbld', 10:17:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:17:23 INFO - 'LOGNAME': 'cltbld', 10:17:23 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:17:23 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 10:17:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:23 INFO - 'MOZ_NO_REMOTE': '1', 10:17:23 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:17:23 INFO - 'NO_EM_RESTART': '1', 10:17:23 INFO - 'PAGER': '/bin/cat', 10:17:23 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:17:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:17:23 INFO - 'PWD': '/builds/slave/test', 10:17:23 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:17:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:17:23 INFO - 'SHELL': '/bin/bash', 10:17:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.TXBqktLF78/Listeners', 10:17:23 INFO - 'TMPDIR': '/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/', 10:17:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:17:23 INFO - 'USER': 'cltbld', 10:17:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:17:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:17:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:23 INFO - 'XPC_FLAGS': '0x0', 10:17:23 INFO - 'XPC_SERVICE_NAME': '0', 10:17:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:17:23 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0294', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 10:17:23 INFO - mozversion application_buildid: 20160706073523 10:17:23 INFO - mozversion application_changeset: 85f50dde3d351d93b571ac49ff71cf5140a2a3a7 10:17:23 INFO - mozversion application_display_name: Firefox 10:17:23 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:17:23 INFO - mozversion application_name: Firefox 10:17:23 INFO - mozversion application_remotingname: firefox 10:17:23 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 10:17:23 INFO - mozversion application_vendor: Mozilla 10:17:23 INFO - mozversion application_version: 48.0 10:17:23 INFO - mozversion platform_buildid: 20160706073523 10:17:23 INFO - mozversion platform_changeset: 85f50dde3d351d93b571ac49ff71cf5140a2a3a7 10:17:23 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 10:17:23 INFO - mozversion platform_version: 48.0 10:17:23 INFO - using testdate: 1467825443 10:17:23 INFO - actual date: 1467825443 10:17:23 INFO - starting webserver on 'localhost:49274' 10:17:23 INFO - SUITE-START | Running 2 tests 10:17:23 INFO - TEST-START | dromaeo_css 10:17:23 INFO - operating with platform_type : mac_ 10:17:23 INFO - Initialising browser for dromaeo_css test... 10:17:23 INFO - TEST-INFO | started process 1659 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/tmpLsrZ71/profile http://localhost:49274/getInfo.html) 10:17:26 INFO - PROCESS | 1659 | __metrics Screen width/height:1600/1200 10:17:26 INFO - PROCESS | 1659 | colorDepth:24 10:17:26 INFO - PROCESS | 1659 | Browser inner width/height: 1024/689 10:17:26 INFO - PROCESS | 1659 | __metrics 10:17:26 ERROR - PROCESS | 1659 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2931: TypeError: this.tabs is undefined 10:17:27 INFO - TEST-INFO | 1659: exit 0 10:17:27 INFO - Browser initialized. 10:17:27 INFO - Running cycle 1/1 for dromaeo_css test... 10:17:27 INFO - TEST-INFO | started process 1663 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/tmpLsrZ71/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:17:38 INFO - PROCESS | 1663 | RSS: Main: 171016192 10:17:38 INFO - PROCESS | 1663 | 10:18:28 INFO - PROCESS | 1663 | 1467825508604 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 10:20:38 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49274/tests/dromaeo/cssquery-ext.html) 10:20:40 INFO - PROCESS | 1663 | RSS: Main: 182079488 10:20:40 INFO - PROCESS | 1663 | 10:23:42 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-ext.html (next: http://localhost:49274/tests/dromaeo/cssquery-jquery.html) 10:23:42 INFO - PROCESS | 1663 | RSS: Main: 192589824 10:23:42 INFO - PROCESS | 1663 | 10:26:44 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49274/tests/dromaeo/cssquery-mootools.html) 10:26:45 INFO - PROCESS | 1663 | RSS: Main: 194727936 10:26:45 INFO - PROCESS | 1663 | 10:29:46 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49274/tests/dromaeo/cssquery-prototype.html) 10:29:47 INFO - PROCESS | 1663 | RSS: Main: 198365184 10:29:47 INFO - PROCESS | 1663 | 10:32:49 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49274/tests/dromaeo/cssquery-yui.html) 10:32:50 INFO - PROCESS | 1663 | RSS: Main: 197525504 10:32:50 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-yui.html (next: http://localhost:49274/tests/dromaeo/cssquery-dojo.html) 10:35:52 INFO - PROCESS | 1663 | RSS: Main: 203108352 10:35:52 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | __start_tp_report 10:35:52 INFO - PROCESS | 1663 | _x_x_mozilla_page_load 10:35:52 INFO - PROCESS | 1663 | _x_x_mozilla_page_load_details 10:35:52 INFO - PROCESS | 1663 | |i|pagename|runs| 10:35:52 INFO - PROCESS | 1663 | |0;dojo.html;3603.153258984139;3629.4918711380396;3663.9267214655724;3692.630736926307;3694.464302676112;5793.478586927181;5887.646741195531;5897.734601942912;5898.675572843497;5929.377415371383;5893.38119497453;5916;5947.434993675594;5955.047192449209;5985.34161242263;4500.842470513517;5290.39160496543;5306.893862122755;5319.521243088121;5381.461853814626;4135.607117323864;4474.501042150883;4870.1720707479635;4924.679895806779;5259.815906443275;4338.631216346598;5348.491893270153;5349.22436246744;5355.116405793039;5359.1425371940495;5337.386200586943;5341.412444631087;5381.165919282498;5382.381026182;5448.128299472105;5274.709890955995;5327.520523152934;5333.386660534011;5356.598255130881;5375.569954403638;4718.678769944421;5001.724905130252;5088.847334579968;5655.717214139318;5659.066254068115;6223.968880155616;6271.059341098826;6271.6864156792435;6272.8118156455375;6290.685465726695;6297.307296197415;6300.9684951574945;6303.842403939938;6344.1435406220035;6347;5833.358330583633;5907.556933230025;5929;5930.762769489215;5995.61028533144;6329.145565348619;6417.358264173546;6481.48148148147;6490;6499.09012738217;6305.085762564494;6348.619082855043;6367.681615919186;6376.649284289316;6377.489800816016;4728.668993170445;5248.897731476432;6348.301686814447;6358.268799088071;6376.521760867953;6297.622142671363;6308.369163083747;6321.936780632135;6331.240251169889;6342.651154186564;6258.280297765815;6259.248890133122;6268.435840774352;6298.1812364392335;6318.431341179224;4914.5822605078965;5035.874103147451;5092.898142037213;5110.540051395392;5129.9230511542355;4550.453945526492;4565.223911934979;4569.428821397325;4582.564656357641;4612.2012415158115;5999.580029397987;6134.631922084689;6137.877242455126;6210.937890621126;6232.626042437469;6224.502039836802;6276.372362763687;6302.180716506917;6304.905426418607;6358.554901156875;6092.908606370908;6133.202683651097;6156.322804491502;6172.094993645457;6199.721012554446;5447.4824891635235;5591.496765291062;5595.07681232592;5608.46719561641;5627.803026894121;6509.349065093453;6525.673716314165;6538.280789113193;6624.30444803308;6624.735010599618;5216.608754343515;6284.3087260402235;6335.778247761306;6343.3339499351905;6364.6181229126405;6643.468522518284;6650.334966503311;6655.900161497485;6668.433183179484;6669.09967154428;5115.772214668527;6119.571629985859;6197.845053873689;6343.3339499351905;6353.36466353361;6269;6300.369963003663;6305.5901366411035;6321.715522801577;6333.145025421693;6100.520618787021;6205.441510264098;6271.937280627135;6286.7799627014665;6289.182406287154;5117.513836185556;6213.844653883689;6269.655168965751;6292.937070629235;6325.462335701517;5154.561862241601;6136.631802091889;6163.506919446344;6194.659293738888;6220.284667263322;5101.540861322499;5168.896622067613;6189.5048396129105;6307.526935479949;6323.652199128908;6177.444030037318;6246.406591373812;6258.968705156445;6266.310705822265;6268.905966410599 10:35:52 INFO - PROCESS | 1663 | |1;ext.html;533.3306700091385;539.1373801916933;554.5092593055148;605.8606520500288;621.7885918787613;39392.21215575687;40441.59558404415;40512.79743601285;40640.18719625609;40670.593294067054;44136.117277654426;44514.7774261129;45116.54883451165;45139.54860451403;45421.7728911355;7594.772156835304;9869.851952220723;9908.851367229498;9911.950440247789;9926.106650401462;9770;9815.803683926317;9882.752931176743;9912.107910288072;9965.501724913762;9895.604175832957;9928.255380846429;9938.304318697657;9940.552675129637;9966.501674916262;9851.802963940718;9861.260405469618;9909.058639429242;9912.207023438108;9922.900770992306;9731.902680973171;9739.318247722662;9770.951145244228;9849.50752462374;9851.211903047739;39810.40284395737;40141;40590.1881962362;41015.58984410177;41456.37815432771;3293.736501079908;3369.0903456066726;3439.6216416194197;3474.6351633078666;3515.6484351564895;24915.252542423757;28794.568081478796;29267;29943.700562994527;30069.849650751825;2762.986185069082;2768.6262354582077;2798.8082107690143;2800.201942446393;2802.453521563296;417052.9147354244;427791;470490;470781;470962;64283.67858160679;64572.677136614955;64631.676841616434;64667.35332646708;64707.38231544249;72269.63865180641;72899.63550182215;73877.89183162258;74128;74164.62917685485;14668.486602968846;18475.260989560535;18495.44513664592;18682.53293667642;18769.967651779283;13915.930420347833;14294.857051429353;14398.352074156688;14413.351399187062;14434;17206.741898871278;20404.79595204029;20422.69365959512;20563.177472900916;21049.89475052615;6859.971004349388;7609.619519024027;8507.659693612186;8558.957205213934;8594.52730099838;980.3921568627496;1063.2982231727024;1084.511969613677;1121.3664279681955;1147.4664281109324;25234.621480677804;30560.235994100327;30707.07878763641;31274.21814454657;31390.37219255602;872.9306599415792;1158.8145896656495;1168.1764356128908;1188.0554958807768;1260.7289432771815;15250.694986100216;15951.44169954046;16144.677106457804;16220.837791622169;16280.43018494347;578809;625363;632624;638022;642802;62640;63379.04931426032;63873.36126638767;63925.36074639287;64079.679601601696;1564.6792407556425;1583.7782710420781;1594.6651203247447;1597.2812234494525;1668.5161303222174;30453;30904.53643195309;30940.762369504966;31359.21601959969;31543.68456315499;54875.72562137164;55135;55288.72355638196;55311.723441382535;55347;554394;555709;557753;558568;560426;27666;27983.720162798112;28170.43659126847;28619.856900715364;28628.42743145167;45464.31803522884;46249.30626040545;47494;49087;49584;33408.164795879326;38273.425898610985;39377.621783237446;40297.99255018531;40555.59444405518;38606.80696596499;39095.02262443462;39781;39911.800440997606;40024.799876000434;39727.80136099301;39748.403773943995;40530.594694052685;41347.58652413558;41387.586124139576;31062.68937310598;33832.83083584566;34335.14162145966;34430;34711.4793278096;24914.377140571632;25727.485450291264;25762.484750304513;25800.61299080553;25960.480790384463 10:35:52 INFO - PROCESS | 1663 | |2;jquery.html;415.73600763515157;415.89394704350406;416.96872734544917;425.2494347476703;429.63695677152793;20727.792722072776;21217.363479095613;21259.25592604259;21483.355499335026;21751.782482175175;21594.676079858815;21906.342809715734;21993.560128797453;22295.777042229613;22483.66274505884;5729.598928075036;5900.114982752579;6011.849703757419;6044.909326360097;6078.726457309432;4428.225060614395;5835;5952.077427998645;6307.526935479835;6592.241892182413;6453.935460645381;6512.153420055386;6537.705803238866;6542.542022058457;6543.869122617545;6377.266614339341;6431.483814644706;6535.640539770311;6536.901946470807;6548.083268342436;5643.802466913638;5667.291588551431;5776.768929242825;5778.162166485836;5796.88406231873;13363.599092027254;13532.661683457894;13684.93157534206;14012.089214201043;14036.649083772987;2080.4590806390297;2316.224064938248;2365.4559451326118;2520.4455019895777;2598.701149367828;10460.953904609554;11026.503807328689;12789.249328827484;14595.416183352652;14898.553043408607;1716.4936343778616;1748.2482532511015;1767.505098572389;1796.7574377459136;1822.180018991459;112051;114958.42520787343;117947;120232;120833.79166208401;9601.655768192459;10641.733956651145;10774.892251077388;11922.761544769057;11952.940235298942;15361.001534900195;15364.385424582892;15384.38462461489;15412.614684632974;15416.922915385352;7474.962625186839;8772.649094036295;9219;9242.399244049115;9284.25725941923;7480.551166930001;7750.7674769756995;9044.592993315317;9102.089791020844;9302.906970930204;4781.2350023996;4848.0546293472435;4873.31773551703;4907.1903135982875;4940.135476291634;1680.848618696197;1904.8190421910174;2001.5696625225646;2020.6362854686004;2123.77700341465;962.302330810171;1012.3976234140674;1034.3586976074882;1057.2493529594074;1082.3343643659093;19910;20724.196816640622;20868;20919.68620470694;21199.15203391847;998.1465846701111;1006.8439391894268;1020.4897551224387;1025.687165414541;1030.3766221436074;10828.783424331627;11216.046636035866;11228.719282018015;11444.713882152846;11457.02615277694;621048;622799.8860005671;643031;643145.568544318;645996;78416;121324;124557.37721311336;125444;130389;879.2570278114982;1029.953652085658;1035.968920932358;1039.5270152080784;1061.7239517725293;18475.35336263278;18564.721529177343;18958.810411895705;19050.333238336592;19529;46247.38134165288;49281.512584114025;49518;53620.1956970638;53961.460385397215;73125.6343718278;75263;75731;77192;77308.2269177301;7718.3053525183;8329.3336533076;8422.24199822019;8628.439151455135;8656.610452529778;9794.853077203705;13115.672108197372;13118.409671564994;13240.53658121961;13297.66755831112;10435.130339156793;11389.373584452935;11411.54353825871;11597.478113484745;12042.698932526757;11219;11432.256903301259;11499.8275025873;11589.304641721186;11651;9482.241420686467;11618.360990145624;11669.416529173677;11868.228565143238;11909.40452977365;6940.375366217065;8530.019047809581;8628.180322869317;8690.26132778721;8877.467351958903;7962.7213047543055;9340;11629.76740465203;11892.167548271538;11931.403429828648 10:35:52 INFO - PROCESS | 1663 | |3;mootools.html;1659.560216542616;1680.10954194277;2032.0550943811133;2040.928567500138;2134.9786502134975;8393.370497212703;9126.954365228174;9164.679236226733;9345.579448924798;9362.531873406328;9103.544822758851;9145.679901203459;9242.86135707965;9256.30577706673;9262.490563019031;2560.1551488009004;2564.987175064122;2567.7047139578954;2594.13096612635;2598.2075466982565;2544.75824796644;2569;2586.4956333514974;2592.494463579603;2614.6339512468176;2552.808539359546;2574.665293511841;2608.21753473958;2616.515944550255;2621.803364747642;2158.791076996879;2568.3579105223694;2602.7267136950536;2603.544379733558;2610.39960809014;2577.8195526313166;2607.830491018097;2617.018618018243;2620.475904819044;2636.4727054589157;9365.250779937589;9438.292128090421;9485.525723713787;9492.905070949271;9516.19112375449;4949.331840201598;5694.316681998145;5736.827895163152;5751.482366587027;5897.52819774417;3522.119470132467;3680.263947210542;3772.5661548921953;3822.1782316802023;3831.5210598675167;1056.4189695667353;1063.2025980514613;1078.1751959750798;1117.7261570915095;1119.076761671616;12166.57416990401;12494.437750301258;12678.175918565265;12692.238465691995;12743.362831858463;5044.041632089965;5063.227870245459;5120.436751957282;5172.534471897472;5208.5051920067535;10665.73335666599;10681;10684.305520141166;10684.30552014132;10687.893121068846;5566.137248726453;5622.465865742748;5622.943770562324;5851.38560451155;5855.502282305966;4718.150732868048;5112.795488180505;5130.333056702605;5240.475952404805;5251.081060814342;4283.443152390169;4284.357346398066;4295.291276939332;4342.457192850894;4380.846670366585;1418.5673369622364;1427.1793718611632;1431.8854491640643;1436.5921397030759;1443.5092068696692;946.0586716217271;958.3195930889008;994.28908330544;1001.8597396364515;1018.674024312213;6103.328633850273;6192.783252586138;6204.410580994799;6256.562040657202;6362.363763623601;469.4015130708306;486.2463182067781;486.90261947610617;495.6431369414016;499.2112462309542;3523.4010218262956;4067.4102255173425;4110.383442483591;4155.418241446139;4196.097838964637;8821.735347939572;11332;11354.205205635692;11406.600768973047;11433.314001159957;10842.403667798348;10850.511726972305;10876.456177191109;11071.16966227536;11189.936955989167;7453.590052547162;8633.740987770378;8709.869351959598;8785.912140878638;8811.074837142009;5771.509421699203;6013.849653758691;6139.754409823557;6190.907136393048;6192.938070619236;10052.195824334181;10176.440295783803;10198.286119971828;10236.948815255875;10238.641647542301;10048.397096174253;10302.639407620698;10431.582736690447;10490.947545262225;10513.94860513973;7203.2076471589135;7697.923020769721;7851.84296314082;7897.960510197412;7940.325072368913;8634.5251011195;8678.78303042429;8713.215810577078;8727.56362181901;8730.650773969224;7588.696452142073;7738.264864837832;7779.611019449118;7844.019497562805;7846;6724.831879203059;7393.704251829867;7607.429442791702;7613.314801667876;7739.961300193463;6184.783532576338;7253.238409966877;7339.155997060407;7363.631818409165;7378.151512575908;4170.541240463486;4353.824467393849;5022.573081287986;5139.306193663808;5238.109521381298;4056.5537790842395;5153.510416510426;5182.22266659989;5230.032443997872;5242.16125419931 10:35:52 INFO - PROCESS | 1663 | |4;prototype.html;316.3467439736943;343.77139202430385;344.72594287541403;349.34497816593887;352.67025331315205;5405.783768649254;6858.51990360675;6913.861722765541;6947.826304342381;6991.685374158163;6869.931300686992;6872.82817929552;6876.8968465472935;6881.724731010753;6894.517383783137;4766.189747742884;4911.852644420655;5040.269160971657;5052.570531504826;5054.064997975386;4989.675671081386;5039.748012599373;5057.342545469102;5058.165402708549;5070.9604531071045;4967.478414766451;5010.924836127461;5019.974900125494;5032.320636714052;5038.093143234217;5008.924866126993;5010.048090862724;5043.747812609355;5046.798128074873;5065.772040258197;3609.675129238355;3785.9621403785886;4064.5325787534516;4234.25900467417;4344.608985191317;5489.807856724996;5524.254225679562;5637.816058627693;6341.651209183493;6576.8355791105605;5970.253718285215;6029.065494848305;6035.185249991239;6043.153958445821;6043.969780151115;7339.192688804227;7355.190928997806;7357.301056399633;7372.7050917963215;7384.150822655356;4873.439554451213;4880.194767863299;4887.120318342697;4900.093482705675;4900.215965445512;7608.391328693691;7640.274173953466;7821.865829454698;7836.843263134705;7848;4975.203967365204;5028.17035189197;5035.496450354935;5038.992201559703;5053.242013697901;5085.923711144335;5112.309838171874;5140.717260550631;5140.922886156711;5157.355330583677;6011.308699499614;6030.7889223876955;6040.4563589276295;6063.151158837766;6065.60573562717;7383.520071195355;7387.224341444071;7390.7413240536325;7420.072490938633;7425.62871856405;1505.6612262241126;1694.542693283775;1763.1360633289596;1789.34688838573;1791.113398867569;1043.389617074005;1085.2294870641774;1086.9782604347868;1089.7166736648528;1095.6055819904827;5532.446755324516;5879.618289701916;6933.826654333682;6960;6999.510034297652;6883.552569083094;7350.00774895393;7543.622818859145;7557.811054723676;7575.431842611826;6357.205349331333;6921.238663746984;7079.079719636415;7080.964595177094;7088.0785497884945;3528.7353448491467;4009.258287216874;4032.0927791247323;4043.3732771420478;4044.2720310343834;7459.291367320096;8080.43436959419;8088.555129467935;8089.514629122272;8117.387762445655;7700.5379677218425;7873.842523149619;7936.087349954713;7951.204879512003;7956.801079973047;8149.633266503021;8164;8205.384596155192;8214.63034163464;8220.794480138044;6298.464630506458;7714.4599878008;7762.41781866351;7771.33943614799;7793.805154871174;7494.437917156344;7587.886181707389;7600.1639819620905;7615.771526854203;7622.733204337822;7715.074191097105;8056.315213206943;8108.432409731262;8132.634031468717;8159.26566609008;4812.831550895702;4821.807127714992;4866.853994380174;4890.853274401774;4904.950950490449;7617.771466856003;7624.5425274483705;7636.236376362319;7638.541687498546;7642.891780691657;7278.272172782891;7315.6342182889575;7359.963200183965;7368.926310736824;7392;7134.678939447634;7380.225076367119;7390.852182956203;7399.297066778648;7473.991011213634;7136.357727804522;7188.676509557187;7199.892001619875;7207.360283057023;7211.67547460355;7363.631818408951;7387.002754628056;7398.556086634604;7409.481336306407;7414.518056326321;6349.9682501587195;6948.826279343057;7126.928730712627;7230.493865429369;7237.63811809418 10:35:52 INFO - PROCESS | 1663 | |5;yui.html;717.9317964793344;725.4341613541436;754.4831790223694;769.1731388757081;791.9683212671493;14032.859671403283;15398.769018464718;15511;15621.375144994201;15874.285657145441;13537.593872183825;14341.498047568337;14696.926515367408;14730.55808325752;14757.966942314042;799.6961154761183;949.900260472649;954.0316578672653;956.7034219391976;967.9806403871918;979.6962941488126;980.039561229995;983.8179936711696;984.517586382671;986.6398764450995;990.1286867556577;991.3556188477511;993.3344659078399;1040.2146379483518;1044.2377064742743;1002.8796544414644;1024.933379330345;1033.7415646088477;1036.1555332404141;1036.4144258494002;736.1313649893124;738.04791818554;764.9388048956071;781.8123650323938;782.5891407011308;15150.621234469116;15192.392304307925;15235.466758663393;15307.46423875159;15628.843711562966;12941.352932353439;12967;13128.0810343276;13132.540361087411;13138.540151094665;10159.492025398775;10347.586096556128;10360.689179324632;10430.16558675304;10449.425281609509;3542.2030043240065;3575.856965721368;3606.796622537269;3643.362411577963;3721.6836568891677;85585;86925;87327.56336218341;88735;89153;9731.659391921248;9783.36408133469;9786.217102631772;9791.755206119904;9893.802123957625;21651.566968660853;22061.22785702525;22434.55130897373;22537.774622253895;22683.43291417695;7683.807904802313;7780.727674531364;7892.329152022143;8000.239977202156;8082.555459449787;4103.29672510094;4126.793660316972;4142.627163555234;4198.9370159447635;4418.823247070081;3755.399136138205;3758.210775737126;3787.7727336359358;3792.6965842732516;3808.3716186828865;589.7080944932201;689.4243306838746;689.5001124184926;690.7340673840507;710.499098135813;487.70777346471726;575.3556017260611;606.5056978562545;616.636184651058;627.7457629659995;8273.503589784512;8307.584620768937;8335.166483351617;8349.707760228363;8583.39916205872;528.3659608469851;545.7080461952916;548.1674978231619;612.9908051379233;638.7445021991148;3930.0960779020984;3936.3701807710627;3959.7822119783114;4046.5751096135073;4125.855595054159;94416.52791736135;94945;95313.5234323824;95523;95669.04330956741;81281;81616.18383816085;82649.58675206585;82790;82860.17139828645;69520.6523967387;69745.99999999898;70425.64787176032;71393;73106.17234569178;8291.626876790438;8431;8532.360072994426;8662.133786621287;8662.956685216534;50222;50905;51179;51736.74131629318;51896.038766553866;66876.33123668896;68041.65979170073;69099;69723;70334.64832675803;11144.888551114385;11158.832617510907;11220.438978051228;11417;11497.252678575866;11919.46362413676;12168.634940951786;12263.877361226274;12327.876721232673;12350.876491234972;11460.598879039193;11511.712207194887;11527.654170374903;11681.474333654836;11785.116116291141;9014.909850901407;10255.07704306616;10462.63380781669;10576.84134737995;10813.783724325627;10904.12766978624;10918.890811091787;11413.942930285295;11453.656390308304;11597.478113484745;9718.805623887623;9759.024097590183;9920.652777153055;10152.949235253776;10247.538860751432;9730.939911246254;9938.006199380005;9985.850212246676;10046.497675116068;10051.497425128568 10:35:52 INFO - PROCESS | 1663 | __end_tp_report 10:35:52 INFO - PROCESS | 1663 | __start_cc_report 10:35:52 INFO - PROCESS | 1663 | _x_x_mozilla_cycle_collect,393 10:35:52 INFO - PROCESS | 1663 | __end_cc_report 10:35:52 INFO - PROCESS | 1663 | __startTimestamp1467826552963__endTimestamp 10:35:52 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | ------- Summary: start ------- 10:35:52 INFO - PROCESS | 1663 | Number of tests: 6 10:35:52 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | [#0] dojo.html Cycles:165 Average:5816.35 Median:6163.51 stddev:698.79 (11.3%) stddev-sans-first:679.02 10:35:52 INFO - PROCESS | 1663 | Values: 3603.2 3629.5 3663.9 3692.6 3694.5 5793.5 5887.6 5897.7 5898.7 5929.4 5893.4 5916.0 5947.4 5955.0 5985.3 4500.8 5290.4 5306.9 5319.5 5381.5 4135.6 4474.5 4870.2 4924.7 5259.8 4338.6 5348.5 5349.2 5355.1 5359.1 5337.4 5341.4 5381.2 5382.4 5448.1 5274.7 5327.5 5333.4 5356.6 5375.6 4718.7 5001.7 5088.8 5655.7 5659.1 6224.0 6271.1 6271.7 6272.8 6290.7 6297.3 6301.0 6303.8 6344.1 6347.0 5833.4 5907.6 5929.0 5930.8 5995.6 6329.1 6417.4 6481.5 6490.0 6499.1 6305.1 6348.6 6367.7 6376.6 6377.5 4728.7 5248.9 6348.3 6358.3 6376.5 6297.6 6308.4 6321.9 6331.2 6342.7 6258.3 6259.2 6268.4 6298.2 6318.4 4914.6 5035.9 5092.9 5110.5 5129.9 4550.5 4565.2 4569.4 4582.6 4612.2 5999.6 6134.6 6137.9 6210.9 6232.6 6224.5 6276.4 6302.2 6304.9 6358.6 6092.9 6133.2 6156.3 6172.1 6199.7 5447.5 5591.5 5595.1 5608.5 5627.8 6509.3 6525.7 6538.3 6624.3 6624.7 5216.6 6284.3 6335.8 6343.3 6364.6 6643.5 6650.3 6655.9 6668.4 6669.1 5115.8 6119.6 6197.8 6343.3 6353.4 6269.0 6300.4 6305.6 6321.7 6333.1 6100.5 6205.4 6271.9 6286.8 6289.2 5117.5 6213.8 6269.7 6292.9 6325.5 5154.6 6136.6 6163.5 6194.7 6220.3 5101.5 5168.9 6189.5 6307.5 6323.7 6177.4 6246.4 6259.0 6266.3 6268.9 10:35:52 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | [#1] ext.html Cycles:180 Average:69262.55 Median:40572.89 stddev:146422.85 (360.9%) stddev-sans-first:146742.68 10:35:52 INFO - PROCESS | 1663 | Values: 533.3 539.1 554.5 605.9 621.8 39392.2 40441.6 40512.8 40640.2 40670.6 44136.1 44514.8 45116.5 45139.5 45421.8 7594.8 9869.9 9908.9 9912.0 9926.1 9770.0 9815.8 9882.8 9912.1 9965.5 9895.6 9928.3 9938.3 9940.6 9966.5 9851.8 9861.3 9909.1 9912.2 9922.9 9731.9 9739.3 9771.0 9849.5 9851.2 39810.4 40141.0 40590.2 41015.6 41456.4 3293.7 3369.1 3439.6 3474.6 3515.6 24915.3 28794.6 29267.0 29943.7 30069.8 2763.0 2768.6 2798.8 2800.2 2802.5 417052.9 427791.0 470490.0 470781.0 470962.0 64283.7 64572.7 64631.7 64667.4 64707.4 72269.6 72899.6 73877.9 74128.0 74164.6 14668.5 18475.3 18495.4 18682.5 18770.0 13915.9 14294.9 14398.4 14413.4 14434.0 17206.7 20404.8 20422.7 20563.2 21049.9 6860.0 7609.6 8507.7 8559.0 8594.5 980.4 1063.3 1084.5 1121.4 1147.5 25234.6 30560.2 30707.1 31274.2 31390.4 872.9 1158.8 1168.2 1188.1 1260.7 15250.7 15951.4 16144.7 16220.8 16280.4 578809.0 625363.0 632624.0 638022.0 642802.0 62640.0 63379.0 63873.4 63925.4 64079.7 1564.7 1583.8 1594.7 1597.3 1668.5 30453.0 30904.5 30940.8 31359.2 31543.7 54875.7 55135.0 55288.7 55311.7 55347.0 554394.0 555709.0 557753.0 558568.0 560426.0 27666.0 27983.7 28170.4 28619.9 28628.4 45464.3 46249.3 47494.0 49087.0 49584.0 33408.2 38273.4 39377.6 40298.0 40555.6 38606.8 39095.0 39781.0 39911.8 40024.8 39727.8 39748.4 40530.6 41347.6 41387.6 31062.7 33832.8 34335.1 34430.0 34711.5 24914.4 25727.5 25762.5 25800.6 25960.5 10:35:52 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | [#2] jquery.html Cycles:180 Average:35498.52 Median:21539.02 stddev:105419.43 (489.4%) stddev-sans-first:105682.24 10:35:52 INFO - PROCESS | 1663 | Values: 415.7 415.9 417.0 425.2 429.6 20727.8 21217.4 21259.3 21483.4 21751.8 21594.7 21906.3 21993.6 22295.8 22483.7 5729.6 5900.1 6011.8 6044.9 6078.7 4428.2 5835.0 5952.1 6307.5 6592.2 6453.9 6512.2 6537.7 6542.5 6543.9 6377.3 6431.5 6535.6 6536.9 6548.1 5643.8 5667.3 5776.8 5778.2 5796.9 13363.6 13532.7 13684.9 14012.1 14036.6 2080.5 2316.2 2365.5 2520.4 2598.7 10461.0 11026.5 12789.2 14595.4 14898.6 1716.5 1748.2 1767.5 1796.8 1822.2 112051.0 114958.4 117947.0 120232.0 120833.8 9601.7 10641.7 10774.9 11922.8 11952.9 15361.0 15364.4 15384.4 15412.6 15416.9 7475.0 8772.6 9219.0 9242.4 9284.3 7480.6 7750.8 9044.6 9102.1 9302.9 4781.2 4848.1 4873.3 4907.2 4940.1 1680.8 1904.8 2001.6 2020.6 2123.8 962.3 1012.4 1034.4 1057.2 1082.3 19910.0 20724.2 20868.0 20919.7 21199.2 998.1 1006.8 1020.5 1025.7 1030.4 10828.8 11216.0 11228.7 11444.7 11457.0 621048.0 622799.9 643031.0 643145.6 645996.0 78416.0 121324.0 124557.4 125444.0 130389.0 879.3 1030.0 1036.0 1039.5 1061.7 18475.4 18564.7 18958.8 19050.3 19529.0 46247.4 49281.5 49518.0 53620.2 53961.5 73125.6 75263.0 75731.0 77192.0 77308.2 7718.3 8329.3 8422.2 8628.4 8656.6 9794.9 13115.7 13118.4 13240.5 13297.7 10435.1 11389.4 11411.5 11597.5 12042.7 11219.0 11432.3 11499.8 11589.3 11651.0 9482.2 11618.4 11669.4 11868.2 11909.4 6940.4 8530.0 8628.2 8690.3 8877.5 7962.7 9340.0 11629.8 11892.2 11931.4 10:35:52 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | [#3] mootools.html Cycles:180 Average:5969.86 Median:2602.20 stddev:3339.07 (128.3%) stddev-sans-first:3332.72 10:35:52 INFO - PROCESS | 1663 | Values: 1659.6 1680.1 2032.1 2040.9 2135.0 8393.4 9127.0 9164.7 9345.6 9362.5 9103.5 9145.7 9242.9 9256.3 9262.5 2560.2 2565.0 2567.7 2594.1 2598.2 2544.8 2569.0 2586.5 2592.5 2614.6 2552.8 2574.7 2608.2 2616.5 2621.8 2158.8 2568.4 2602.7 2603.5 2610.4 2577.8 2607.8 2617.0 2620.5 2636.5 9365.3 9438.3 9485.5 9492.9 9516.2 4949.3 5694.3 5736.8 5751.5 5897.5 3522.1 3680.3 3772.6 3822.2 3831.5 1056.4 1063.2 1078.2 1117.7 1119.1 12166.6 12494.4 12678.2 12692.2 12743.4 5044.0 5063.2 5120.4 5172.5 5208.5 10665.7 10681.0 10684.3 10684.3 10687.9 5566.1 5622.5 5622.9 5851.4 5855.5 4718.2 5112.8 5130.3 5240.5 5251.1 4283.4 4284.4 4295.3 4342.5 4380.8 1418.6 1427.2 1431.9 1436.6 1443.5 946.1 958.3 994.3 1001.9 1018.7 6103.3 6192.8 6204.4 6256.6 6362.4 469.4 486.2 486.9 495.6 499.2 3523.4 4067.4 4110.4 4155.4 4196.1 8821.7 11332.0 11354.2 11406.6 11433.3 10842.4 10850.5 10876.5 11071.2 11189.9 7453.6 8633.7 8709.9 8785.9 8811.1 5771.5 6013.8 6139.8 6190.9 6192.9 10052.2 10176.4 10198.3 10236.9 10238.6 10048.4 10302.6 10431.6 10490.9 10513.9 7203.2 7697.9 7851.8 7898.0 7940.3 8634.5 8678.8 8713.2 8727.6 8730.7 7588.7 7738.3 7779.6 7844.0 7846.0 6724.8 7393.7 7607.4 7613.3 7740.0 6184.8 7253.2 7339.2 7363.6 7378.2 4170.5 4353.8 5022.6 5139.3 5238.1 4056.6 5153.5 5182.2 5230.0 5242.2 10:35:52 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | [#4] prototype.html Cycles:180 Average:6022.09 Median:6882.64 stddev:1945.46 (28.3%) stddev-sans-first:1903.20 10:35:52 INFO - PROCESS | 1663 | Values: 316.3 343.8 344.7 349.3 352.7 5405.8 6858.5 6913.9 6947.8 6991.7 6869.9 6872.8 6876.9 6881.7 6894.5 4766.2 4911.9 5040.3 5052.6 5054.1 4989.7 5039.7 5057.3 5058.2 5071.0 4967.5 5010.9 5020.0 5032.3 5038.1 5008.9 5010.0 5043.7 5046.8 5065.8 3609.7 3786.0 4064.5 4234.3 4344.6 5489.8 5524.3 5637.8 6341.7 6576.8 5970.3 6029.1 6035.2 6043.2 6044.0 7339.2 7355.2 7357.3 7372.7 7384.2 4873.4 4880.2 4887.1 4900.1 4900.2 7608.4 7640.3 7821.9 7836.8 7848.0 4975.2 5028.2 5035.5 5039.0 5053.2 5085.9 5112.3 5140.7 5140.9 5157.4 6011.3 6030.8 6040.5 6063.2 6065.6 7383.5 7387.2 7390.7 7420.1 7425.6 1505.7 1694.5 1763.1 1789.3 1791.1 1043.4 1085.2 1087.0 1089.7 1095.6 5532.4 5879.6 6933.8 6960.0 6999.5 6883.6 7350.0 7543.6 7557.8 7575.4 6357.2 6921.2 7079.1 7081.0 7088.1 3528.7 4009.3 4032.1 4043.4 4044.3 7459.3 8080.4 8088.6 8089.5 8117.4 7700.5 7873.8 7936.1 7951.2 7956.8 8149.6 8164.0 8205.4 8214.6 8220.8 6298.5 7714.5 7762.4 7771.3 7793.8 7494.4 7587.9 7600.2 7615.8 7622.7 7715.1 8056.3 8108.4 8132.6 8159.3 4812.8 4821.8 4866.9 4890.9 4905.0 7617.8 7624.5 7636.2 7638.5 7642.9 7278.3 7315.6 7360.0 7368.9 7392.0 7134.7 7380.2 7390.9 7399.3 7474.0 7136.4 7188.7 7199.9 7207.4 7211.7 7363.6 7387.0 7398.6 7409.5 7414.5 6350.0 6948.8 7126.9 7230.5 7237.6 10:35:52 INFO - PROCESS | 1663 | 10:35:52 INFO - PROCESS | 1663 | [#5] yui.html Cycles:180 Average:18900.71 Median:26212.20 stddev:26774.33 (102.1%) stddev-sans-first:26814.63 10:35:52 INFO - PROCESS | 1663 | Values: 717.9 725.4 754.5 769.2 792.0 14032.9 15398.8 15511.0 15621.4 15874.3 13537.6 14341.5 14696.9 14730.6 14758.0 799.7 949.9 954.0 956.7 968.0 979.7 980.0 983.8 984.5 986.6 990.1 991.4 993.3 1040.2 1044.2 1002.9 1024.9 1033.7 1036.2 1036.4 736.1 738.0 764.9 781.8 782.6 15150.6 15192.4 15235.5 15307.5 15628.8 12941.4 12967.0 13128.1 13132.5 13138.5 10159.5 10347.6 10360.7 10430.2 10449.4 3542.2 3575.9 3606.8 3643.4 3721.7 85585.0 86925.0 87327.6 88735.0 89153.0 9731.7 9783.4 9786.2 9791.8 9893.8 21651.6 22061.2 22434.6 22537.8 22683.4 7683.8 7780.7 7892.3 8000.2 8082.6 4103.3 4126.8 4142.6 4198.9 4418.8 3755.4 3758.2 3787.8 3792.7 3808.4 589.7 689.4 689.5 690.7 710.5 487.7 575.4 606.5 616.6 627.7 8273.5 8307.6 8335.2 8349.7 8583.4 528.4 545.7 548.2 613.0 638.7 3930.1 3936.4 3959.8 4046.6 4125.9 94416.5 94945.0 95313.5 95523.0 95669.0 81281.0 81616.2 82649.6 82790.0 82860.2 69520.7 69746.0 70425.6 71393.0 73106.2 8291.6 8431.0 8532.4 8662.1 8663.0 50222.0 50905.0 51179.0 51736.7 51896.0 66876.3 68041.7 69099.0 69723.0 70334.6 11144.9 11158.8 11220.4 11417.0 11497.3 11919.5 12168.6 12263.9 12327.9 12350.9 11460.6 11511.7 11527.7 11681.5 11785.1 9014.9 10255.1 10462.6 10576.8 10813.8 10904.1 10918.9 11413.9 11453.7 11597.5 9718.8 9759.0 9920.7 10152.9 10247.5 9730.9 9938.0 9985.9 10046.5 10051.5 10:35:52 INFO - PROCESS | 1663 | -------- Summary: end -------- 10:35:52 INFO - PROCESS | 1663 | 10:35:53 INFO - TEST-INFO | 1663: exit 0 10:35:53 INFO - TEST-OK | dromaeo_css | took 1109961ms 10:35:53 INFO - TEST-START | kraken 10:35:53 INFO - operating with platform_type : mac_ 10:35:53 INFO - Initialising browser for kraken test... 10:35:53 INFO - TEST-INFO | started process 1672 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/tmpEvyrxQ/profile http://localhost:49274/getInfo.html) 10:35:56 INFO - PROCESS | 1672 | __metrics Screen width/height:1600/1200 10:35:56 INFO - PROCESS | 1672 | colorDepth:24 10:35:56 INFO - PROCESS | 1672 | Browser inner width/height: 1024/689 10:35:56 INFO - PROCESS | 1672 | __metrics 10:35:56 ERROR - PROCESS | 1672 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2931: TypeError: this.tabs is undefined 10:35:56 INFO - TEST-INFO | 1672: exit 0 10:35:56 INFO - Browser initialized. 10:35:56 INFO - Running cycle 1/1 for kraken test... 10:35:56 INFO - TEST-INFO | started process 1676 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/tmpEvyrxQ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:36:08 INFO - PROCESS | 1676 | RSS: Main: 171032576 10:36:08 INFO - PROCESS | 1676 | 10:36:11 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-beat-detection) 10:36:12 INFO - PROCESS | 1676 | RSS: Main: 183664640 10:36:12 INFO - PROCESS | 1676 | 10:36:14 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-dft) 10:36:15 INFO - PROCESS | 1676 | RSS: Main: 193003520 10:36:15 INFO - PROCESS | 1676 | 10:36:18 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-fft) 10:36:19 INFO - PROCESS | 1676 | RSS: Main: 195948544 10:36:19 INFO - PROCESS | 1676 | 10:36:21 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-oscillator) 10:36:22 INFO - PROCESS | 1676 | RSS: Main: 197218304 10:36:22 INFO - PROCESS | 1676 | 10:36:24 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:36:24 INFO - PROCESS | 1676 | RSS: Main: 197750784 10:36:24 INFO - PROCESS | 1676 | 10:36:27 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-darkroom) 10:36:28 INFO - PROCESS | 1676 | RSS: Main: 198316032 10:36:28 INFO - PROCESS | 1676 | 10:36:31 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-desaturate) 10:36:32 INFO - PROCESS | 1676 | RSS: Main: 198356992 10:36:32 INFO - PROCESS | 1676 | 10:36:35 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49274/tests/kraken/driver.html?testName=json-parse-financial) 10:36:35 INFO - PROCESS | 1676 | RSS: Main: 198496256 10:36:35 INFO - PROCESS | 1676 | 10:36:37 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49274/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:36:37 INFO - PROCESS | 1676 | RSS: Main: 198328320 10:36:37 INFO - PROCESS | 1676 | 10:36:39 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:36:40 INFO - PROCESS | 1676 | RSS: Main: 198393856 10:36:40 INFO - PROCESS | 1676 | 10:36:42 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:36:43 INFO - PROCESS | 1676 | RSS: Main: 198172672 10:36:43 INFO - PROCESS | 1676 | 10:36:46 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:36:46 INFO - PROCESS | 1676 | RSS: Main: 198242304 10:36:46 INFO - PROCESS | 1676 | 10:36:49 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:36:50 INFO - PROCESS | 1676 | RSS: Main: 198152192 10:36:50 INFO - PROCESS | 1676 | 10:36:51 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49274/tests/kraken/driver.html?testName=ai-astar) 10:36:52 INFO - PROCESS | 1676 | RSS: Main: 200101888 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | __start_tp_report 10:36:52 INFO - PROCESS | 1676 | _x_x_mozilla_page_load 10:36:52 INFO - PROCESS | 1676 | _x_x_mozilla_page_load_details 10:36:52 INFO - PROCESS | 1676 | |i|pagename|runs| 10:36:52 INFO - PROCESS | 1676 | |0;ai-astar;117;112;119;117;117;132;116;115;113;115 10:36:52 INFO - PROCESS | 1676 | |1;audio-beat-detection;152;127;154;210;117;165;174;136;168;126 10:36:52 INFO - PROCESS | 1676 | |2;audio-dft;196;185;234;188;191;192;274;276;202;192 10:36:52 INFO - PROCESS | 1676 | |3;audio-fft;65;75;74;144;57;56;56;71;123;52 10:36:52 INFO - PROCESS | 1676 | |4;audio-oscillator;60;77;151;64;64;63;125;116;119;160 10:36:52 INFO - PROCESS | 1676 | |5;imaging-gaussian-blur;89;87;89;86;89;107;135;73;137;131 10:36:52 INFO - PROCESS | 1676 | |6;imaging-darkroom;94;106;98;92;153;94;94;95;121;98 10:36:52 INFO - PROCESS | 1676 | |7;imaging-desaturate;145;145;107;148;141;90;90;89;118;150 10:36:52 INFO - PROCESS | 1676 | |8;json-parse-financial;59;64;64;64;65;65;64;77;61;59 10:36:52 INFO - PROCESS | 1676 | |9;json-stringify-tinderbox;67;97;109;55;69;100;97;61;68;87 10:36:52 INFO - PROCESS | 1676 | |10;stanford-crypto-aes;82;102;106;106;105;81;79;80;86;82 10:36:52 INFO - PROCESS | 1676 | |11;stanford-crypto-ccm;125;147;143;160;116;142;124;156;164;136 10:36:52 INFO - PROCESS | 1676 | |12;stanford-crypto-pbkdf2;164;163;162;172;163;165;169;163;183;150 10:36:52 INFO - PROCESS | 1676 | |13;stanford-crypto-sha256-iterative;68;67;98;80;70;68;67;67;67;67 10:36:52 INFO - PROCESS | 1676 | __end_tp_report 10:36:52 INFO - PROCESS | 1676 | __start_cc_report 10:36:52 INFO - PROCESS | 1676 | _x_x_mozilla_cycle_collect,1041 10:36:52 INFO - PROCESS | 1676 | __end_cc_report 10:36:52 INFO - PROCESS | 1676 | __startTimestamp1467826612248__endTimestamp 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | ------- Summary: start ------- 10:36:52 INFO - PROCESS | 1676 | Number of tests: 14 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#0] ai-astar Cycles:10 Average:117.30 Median:117.00 stddev:5.56 (4.8%) stddev-sans-first:5.89 10:36:52 INFO - PROCESS | 1676 | Values: 117.0 112.0 119.0 117.0 117.0 132.0 116.0 115.0 113.0 115.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#1] audio-beat-detection Cycles:10 Average:152.90 Median:159.50 stddev:27.99 (17.5%) stddev-sans-first:29.69 10:36:52 INFO - PROCESS | 1676 | Values: 152.0 127.0 154.0 210.0 117.0 165.0 174.0 136.0 168.0 126.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#2] audio-dft Cycles:10 Average:213.00 Median:199.00 stddev:35.46 (17.8%) stddev-sans-first:37.07 10:36:52 INFO - PROCESS | 1676 | Values: 196.0 185.0 234.0 188.0 191.0 192.0 274.0 276.0 202.0 192.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#3] audio-fft Cycles:10 Average:77.30 Median:61.00 stddev:31.10 (51.0%) stddev-sans-first:32.66 10:36:52 INFO - PROCESS | 1676 | Values: 65.0 75.0 74.0 144.0 57.0 56.0 56.0 71.0 123.0 52.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#4] audio-oscillator Cycles:10 Average:99.90 Median:61.50 stddev:38.78 (63.1%) stddev-sans-first:38.35 10:36:52 INFO - PROCESS | 1676 | Values: 60.0 77.0 151.0 64.0 64.0 63.0 125.0 116.0 119.0 160.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#5] imaging-gaussian-blur Cycles:10 Average:102.30 Median:86.50 stddev:23.59 (27.3%) stddev-sans-first:24.52 10:36:52 INFO - PROCESS | 1676 | Values: 89.0 87.0 89.0 86.0 89.0 107.0 135.0 73.0 137.0 131.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#6] imaging-darkroom Cycles:10 Average:104.50 Median:94.00 stddev:19.12 (20.3%) stddev-sans-first:19.89 10:36:52 INFO - PROCESS | 1676 | Values: 94.0 106.0 98.0 92.0 153.0 94.0 94.0 95.0 121.0 98.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#7] imaging-desaturate Cycles:10 Average:122.30 Median:149.00 stddev:26.37 (17.7%) stddev-sans-first:26.65 10:36:52 INFO - PROCESS | 1676 | Values: 145.0 145.0 107.0 148.0 141.0 90.0 90.0 89.0 118.0 150.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#8] json-parse-financial Cycles:10 Average:64.20 Median:64.00 stddev:5.05 (7.9%) stddev-sans-first:4.99 10:36:52 INFO - PROCESS | 1676 | Values: 59.0 64.0 64.0 64.0 65.0 65.0 64.0 77.0 61.0 59.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#9] json-stringify-tinderbox Cycles:10 Average:81.00 Median:68.50 stddev:19.08 (27.9%) stddev-sans-first:19.56 10:36:52 INFO - PROCESS | 1676 | Values: 67.0 97.0 109.0 55.0 69.0 100.0 97.0 61.0 68.0 87.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#10] stanford-crypto-aes Cycles:10 Average:90.90 Median:80.50 stddev:12.11 (15.0%) stddev-sans-first:12.40 10:36:52 INFO - PROCESS | 1676 | Values: 82.0 102.0 106.0 106.0 105.0 81.0 79.0 80.0 86.0 82.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#11] stanford-crypto-ccm Cycles:10 Average:141.30 Median:145.00 stddev:16.16 (11.1%) stddev-sans-first:16.03 10:36:52 INFO - PROCESS | 1676 | Values: 125.0 147.0 143.0 160.0 116.0 142.0 124.0 156.0 164.0 136.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:165.40 Median:164.50 stddev:8.40 (5.1%) stddev-sans-first:8.89 10:36:52 INFO - PROCESS | 1676 | Values: 164.0 163.0 162.0 172.0 163.0 165.0 169.0 163.0 183.0 150.0 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - PROCESS | 1676 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.90 Median:68.00 stddev:10.00 (14.7%) stddev-sans-first:10.51 10:36:52 INFO - PROCESS | 1676 | Values: 68.0 67.0 98.0 80.0 70.0 68.0 67.0 67.0 67.0 67.0 10:36:52 INFO - PROCESS | 1676 | -------- Summary: end -------- 10:36:52 INFO - PROCESS | 1676 | 10:36:52 INFO - TEST-INFO | 1676: exit 0 10:36:52 INFO - TEST-OK | kraken | took 59504ms 10:36:52 INFO - SUITE-END | took 1169s 10:36:53 INFO - Completed test suite (00:19:29) 10:36:53 INFO - javascript benchmark 10:36:53 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3603.153258984139, 3629.4918711380396, 3663.9267214655724, 3692.630736926307, 3694.464302676112, 5793.478586927181, 5887.646741195531, 5897.734601942912, 5898.675572843497, 5929.377415371383, 5893.38119497453, 5916.0, 5947.434993675594, 5955.047192449209, 5985.34161242263, 4500.842470513517, 5290.39160496543, 5306.893862122755, 5319.521243088121, 5381.461853814626, 4135.607117323864, 4474.501042150883, 4870.1720707479635, 4924.679895806779, 5259.815906443275, 4338.631216346598, 5348.491893270153, 5349.22436246744, 5355.116405793039, 5359.1425371940495, 5337.386200586943, 5341.412444631087, 5381.165919282498, 5382.381026182, 5448.128299472105, 5274.709890955995, 5327.520523152934, 5333.386660534011, 5356.598255130881, 5375.569954403638, 4718.678769944421, 5001.724905130252, 5088.847334579968, 5655.717214139318, 5659.066254068115, 6223.968880155616, 6271.059341098826, 6271.6864156792435, 6272.8118156455375, 6290.685465726695, 6297.307296197415, 6300.9684951574945, 6303.842403939938, 6344.1435406220035, 6347.0, 5833.358330583633, 5907.556933230025, 5929.0, 5930.762769489215, 5995.61028533144, 6329.145565348619, 6417.358264173546, 6481.48148148147, 6490.0, 6499.09012738217, 6305.085762564494, 6348.619082855043, 6367.681615919186, 6376.649284289316, 6377.489800816016, 4728.668993170445, 5248.897731476432, 6348.301686814447, 6358.268799088071, 6376.521760867953, 6297.622142671363, 6308.369163083747, 6321.936780632135, 6331.240251169889, 6342.651154186564, 6258.280297765815, 6259.248890133122, 6268.435840774352, 6298.1812364392335, 6318.431341179224, 4914.5822605078965, 5035.874103147451, 5092.898142037213, 5110.540051395392, 5129.9230511542355, 4550.453945526492, 4565.223911934979, 4569.428821397325, 4582.564656357641, 4612.2012415158115, 5999.580029397987, 6134.631922084689, 6137.877242455126, 6210.937890621126, 6232.626042437469, 6224.502039836802, 6276.372362763687, 6302.180716506917, 6304.905426418607, 6358.554901156875, 6092.908606370908, 6133.202683651097, 6156.322804491502, 6172.094993645457, 6199.721012554446, 5447.4824891635235, 5591.496765291062, 5595.07681232592, 5608.46719561641, 5627.803026894121, 6509.349065093453, 6525.673716314165, 6538.280789113193, 6624.30444803308, 6624.735010599618, 5216.608754343515, 6284.3087260402235, 6335.778247761306, 6343.3339499351905, 6364.6181229126405, 6643.468522518284, 6650.334966503311, 6655.900161497485, 6668.433183179484, 6669.09967154428, 5115.772214668527, 6119.571629985859, 6197.845053873689, 6343.3339499351905, 6353.36466353361, 6269.0, 6300.369963003663, 6305.5901366411035, 6321.715522801577, 6333.145025421693, 6100.520618787021, 6205.441510264098, 6271.937280627135, 6286.7799627014665, 6289.182406287154, 5117.513836185556, 6213.844653883689, 6269.655168965751, 6292.937070629235, 6325.462335701517, 5154.561862241601, 6136.631802091889, 6163.506919446344, 6194.659293738888, 6220.284667263322, 5101.540861322499, 5168.896622067613, 6189.5048396129105, 6307.526935479949, 6323.652199128908, 6177.444030037318, 6246.406591373812, 6258.968705156445, 6266.310705822265, 6268.905966410599], "value": 5775.38171282039, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [533.3306700091385, 539.1373801916933, 554.5092593055148, 605.8606520500288, 621.7885918787613, 39392.21215575687, 40441.59558404415, 40512.79743601285, 40640.18719625609, 40670.593294067054, 44136.117277654426, 44514.7774261129, 45116.54883451165, 45139.54860451403, 45421.7728911355, 7594.772156835304, 9869.851952220723, 9908.851367229498, 9911.950440247789, 9926.106650401462, 9770.0, 9815.803683926317, 9882.752931176743, 9912.107910288072, 9965.501724913762, 9895.604175832957, 9928.255380846429, 9938.304318697657, 9940.552675129637, 9966.501674916262, 9851.802963940718, 9861.260405469618, 9909.058639429242, 9912.207023438108, 9922.900770992306, 9731.902680973171, 9739.318247722662, 9770.951145244228, 9849.50752462374, 9851.211903047739, 39810.40284395737, 40141.0, 40590.1881962362, 41015.58984410177, 41456.37815432771, 3293.736501079908, 3369.0903456066726, 3439.6216416194197, 3474.6351633078666, 3515.6484351564895, 24915.252542423757, 28794.568081478796, 29267.0, 29943.700562994527, 30069.849650751825, 2762.986185069082, 2768.6262354582077, 2798.8082107690143, 2800.201942446393, 2802.453521563296, 417052.9147354244, 427791.0, 470490.0, 470781.0, 470962.0, 64283.67858160679, 64572.677136614955, 64631.676841616434, 64667.35332646708, 64707.38231544249, 72269.63865180641, 72899.63550182215, 73877.89183162258, 74128.0, 74164.62917685485, 14668.486602968846, 18475.260989560535, 18495.44513664592, 18682.53293667642, 18769.967651779283, 13915.930420347833, 14294.857051429353, 14398.352074156688, 14413.351399187062, 14434.0, 17206.741898871278, 20404.79595204029, 20422.69365959512, 20563.177472900916, 21049.89475052615, 6859.971004349388, 7609.619519024027, 8507.659693612186, 8558.957205213934, 8594.52730099838, 980.3921568627496, 1063.2982231727024, 1084.511969613677, 1121.3664279681955, 1147.4664281109324, 25234.621480677804, 30560.235994100327, 30707.07878763641, 31274.21814454657, 31390.37219255602, 872.9306599415792, 1158.8145896656495, 1168.1764356128908, 1188.0554958807768, 1260.7289432771815, 15250.694986100216, 15951.44169954046, 16144.677106457804, 16220.837791622169, 16280.43018494347, 578809.0, 625363.0, 632624.0, 638022.0, 642802.0, 62640.0, 63379.04931426032, 63873.36126638767, 63925.36074639287, 64079.679601601696, 1564.6792407556425, 1583.7782710420781, 1594.6651203247447, 1597.2812234494525, 1668.5161303222174, 30453.0, 30904.53643195309, 30940.762369504966, 31359.21601959969, 31543.68456315499, 54875.72562137164, 55135.0, 55288.72355638196, 55311.723441382535, 55347.0, 554394.0, 555709.0, 557753.0, 558568.0, 560426.0, 27666.0, 27983.720162798112, 28170.43659126847, 28619.856900715364, 28628.42743145167, 45464.31803522884, 46249.30626040545, 47494.0, 49087.0, 49584.0, 33408.164795879326, 38273.425898610985, 39377.621783237446, 40297.99255018531, 40555.59444405518, 38606.80696596499, 39095.02262443462, 39781.0, 39911.800440997606, 40024.799876000434, 39727.80136099301, 39748.403773943995, 40530.594694052685, 41347.58652413558, 41387.586124139576, 31062.68937310598, 33832.83083584566, 34335.14162145966, 34430.0, 34711.4793278096, 24914.377140571632, 25727.485450291264, 25762.484750304513, 25800.61299080553, 25960.480790384463], "value": 20670.105124687, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [415.73600763515157, 415.89394704350406, 416.96872734544917, 425.2494347476703, 429.63695677152793, 20727.792722072776, 21217.363479095613, 21259.25592604259, 21483.355499335026, 21751.782482175175, 21594.676079858815, 21906.342809715734, 21993.560128797453, 22295.777042229613, 22483.66274505884, 5729.598928075036, 5900.114982752579, 6011.849703757419, 6044.909326360097, 6078.726457309432, 4428.225060614395, 5835.0, 5952.077427998645, 6307.526935479835, 6592.241892182413, 6453.935460645381, 6512.153420055386, 6537.705803238866, 6542.542022058457, 6543.869122617545, 6377.266614339341, 6431.483814644706, 6535.640539770311, 6536.901946470807, 6548.083268342436, 5643.802466913638, 5667.291588551431, 5776.768929242825, 5778.162166485836, 5796.88406231873, 13363.599092027254, 13532.661683457894, 13684.93157534206, 14012.089214201043, 14036.649083772987, 2080.4590806390297, 2316.224064938248, 2365.4559451326118, 2520.4455019895777, 2598.701149367828, 10460.953904609554, 11026.503807328689, 12789.249328827484, 14595.416183352652, 14898.553043408607, 1716.4936343778616, 1748.2482532511015, 1767.505098572389, 1796.7574377459136, 1822.180018991459, 112051.0, 114958.42520787343, 117947.0, 120232.0, 120833.79166208401, 9601.655768192459, 10641.733956651145, 10774.892251077388, 11922.761544769057, 11952.940235298942, 15361.001534900195, 15364.385424582892, 15384.38462461489, 15412.614684632974, 15416.922915385352, 7474.962625186839, 8772.649094036295, 9219.0, 9242.399244049115, 9284.25725941923, 7480.551166930001, 7750.7674769756995, 9044.592993315317, 9102.089791020844, 9302.906970930204, 4781.2350023996, 4848.0546293472435, 4873.31773551703, 4907.1903135982875, 4940.135476291634, 1680.848618696197, 1904.8190421910174, 2001.5696625225646, 2020.6362854686004, 2123.77700341465, 962.302330810171, 1012.3976234140674, 1034.3586976074882, 1057.2493529594074, 1082.3343643659093, 19910.0, 20724.196816640622, 20868.0, 20919.68620470694, 21199.15203391847, 998.1465846701111, 1006.8439391894268, 1020.4897551224387, 1025.687165414541, 1030.3766221436074, 10828.783424331627, 11216.046636035866, 11228.719282018015, 11444.713882152846, 11457.02615277694, 621048.0, 622799.8860005671, 643031.0, 643145.568544318, 645996.0, 78416.0, 121324.0, 124557.37721311336, 125444.0, 130389.0, 879.2570278114982, 1029.953652085658, 1035.968920932358, 1039.5270152080784, 1061.7239517725293, 18475.35336263278, 18564.721529177343, 18958.810411895705, 19050.333238336592, 19529.0, 46247.38134165288, 49281.512584114025, 49518.0, 53620.1956970638, 53961.460385397215, 73125.6343718278, 75263.0, 75731.0, 77192.0, 77308.2269177301, 7718.3053525183, 8329.3336533076, 8422.24199822019, 8628.439151455135, 8656.610452529778, 9794.853077203705, 13115.672108197372, 13118.409671564994, 13240.53658121961, 13297.66755831112, 10435.130339156793, 11389.373584452935, 11411.54353825871, 11597.478113484745, 12042.698932526757, 11219.0, 11432.256903301259, 11499.8275025873, 11589.304641721186, 11651.0, 9482.241420686467, 11618.360990145624, 11669.416529173677, 11868.228565143238, 11909.40452977365, 6940.375366217065, 8530.019047809581, 8628.180322869317, 8690.26132778721, 8877.467351958903, 7962.7213047543055, 9340.0, 11629.76740465203, 11892.167548271538, 11931.403429828648], "value": 9678.431263372166, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1659.560216542616, 1680.10954194277, 2032.0550943811133, 2040.928567500138, 2134.9786502134975, 8393.370497212703, 9126.954365228174, 9164.679236226733, 9345.579448924798, 9362.531873406328, 9103.544822758851, 9145.679901203459, 9242.86135707965, 9256.30577706673, 9262.490563019031, 2560.1551488009004, 2564.987175064122, 2567.7047139578954, 2594.13096612635, 2598.2075466982565, 2544.75824796644, 2569.0, 2586.4956333514974, 2592.494463579603, 2614.6339512468176, 2552.808539359546, 2574.665293511841, 2608.21753473958, 2616.515944550255, 2621.803364747642, 2158.791076996879, 2568.3579105223694, 2602.7267136950536, 2603.544379733558, 2610.39960809014, 2577.8195526313166, 2607.830491018097, 2617.018618018243, 2620.475904819044, 2636.4727054589157, 9365.250779937589, 9438.292128090421, 9485.525723713787, 9492.905070949271, 9516.19112375449, 4949.331840201598, 5694.316681998145, 5736.827895163152, 5751.482366587027, 5897.52819774417, 3522.119470132467, 3680.263947210542, 3772.5661548921953, 3822.1782316802023, 3831.5210598675167, 1056.4189695667353, 1063.2025980514613, 1078.1751959750798, 1117.7261570915095, 1119.076761671616, 12166.57416990401, 12494.437750301258, 12678.175918565265, 12692.238465691995, 12743.362831858463, 5044.041632089965, 5063.227870245459, 5120.436751957282, 5172.534471897472, 5208.5051920067535, 10665.73335666599, 10681.0, 10684.305520141166, 10684.30552014132, 10687.893121068846, 5566.137248726453, 5622.465865742748, 5622.943770562324, 5851.38560451155, 5855.502282305966, 4718.150732868048, 5112.795488180505, 5130.333056702605, 5240.475952404805, 5251.081060814342, 4283.443152390169, 4284.357346398066, 4295.291276939332, 4342.457192850894, 4380.846670366585, 1418.5673369622364, 1427.1793718611632, 1431.8854491640643, 1436.5921397030759, 1443.5092068696692, 946.0586716217271, 958.3195930889008, 994.28908330544, 1001.8597396364515, 1018.674024312213, 6103.328633850273, 6192.783252586138, 6204.410580994799, 6256.562040657202, 6362.363763623601, 469.4015130708306, 486.2463182067781, 486.90261947610617, 495.6431369414016, 499.2112462309542, 3523.4010218262956, 4067.4102255173425, 4110.383442483591, 4155.418241446139, 4196.097838964637, 8821.735347939572, 11332.0, 11354.205205635692, 11406.600768973047, 11433.314001159957, 10842.403667798348, 10850.511726972305, 10876.456177191109, 11071.16966227536, 11189.936955989167, 7453.590052547162, 8633.740987770378, 8709.869351959598, 8785.912140878638, 8811.074837142009, 5771.509421699203, 6013.849653758691, 6139.754409823557, 6190.907136393048, 6192.938070619236, 10052.195824334181, 10176.440295783803, 10198.286119971828, 10236.948815255875, 10238.641647542301, 10048.397096174253, 10302.639407620698, 10431.582736690447, 10490.947545262225, 10513.94860513973, 7203.2076471589135, 7697.923020769721, 7851.84296314082, 7897.960510197412, 7940.325072368913, 8634.5251011195, 8678.78303042429, 8713.215810577078, 8727.56362181901, 8730.650773969224, 7588.696452142073, 7738.264864837832, 7779.611019449118, 7844.019497562805, 7846.0, 6724.831879203059, 7393.704251829867, 7607.429442791702, 7613.314801667876, 7739.961300193463, 6184.783532576338, 7253.238409966877, 7339.155997060407, 7363.631818409165, 7378.151512575908, 4170.541240463486, 4353.824467393849, 5022.573081287986, 5139.306193663808, 5238.109521381298, 4056.5537790842395, 5153.510416510426, 5182.22266659989, 5230.032443997872, 5242.16125419931], "value": 4756.928990597415, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [316.3467439736943, 343.77139202430385, 344.72594287541403, 349.34497816593887, 352.67025331315205, 5405.783768649254, 6858.51990360675, 6913.861722765541, 6947.826304342381, 6991.685374158163, 6869.931300686992, 6872.82817929552, 6876.8968465472935, 6881.724731010753, 6894.517383783137, 4766.189747742884, 4911.852644420655, 5040.269160971657, 5052.570531504826, 5054.064997975386, 4989.675671081386, 5039.748012599373, 5057.342545469102, 5058.165402708549, 5070.9604531071045, 4967.478414766451, 5010.924836127461, 5019.974900125494, 5032.320636714052, 5038.093143234217, 5008.924866126993, 5010.048090862724, 5043.747812609355, 5046.798128074873, 5065.772040258197, 3609.675129238355, 3785.9621403785886, 4064.5325787534516, 4234.25900467417, 4344.608985191317, 5489.807856724996, 5524.254225679562, 5637.816058627693, 6341.651209183493, 6576.8355791105605, 5970.253718285215, 6029.065494848305, 6035.185249991239, 6043.153958445821, 6043.969780151115, 7339.192688804227, 7355.190928997806, 7357.301056399633, 7372.7050917963215, 7384.150822655356, 4873.439554451213, 4880.194767863299, 4887.120318342697, 4900.093482705675, 4900.215965445512, 7608.391328693691, 7640.274173953466, 7821.865829454698, 7836.843263134705, 7848.0, 4975.203967365204, 5028.17035189197, 5035.496450354935, 5038.992201559703, 5053.242013697901, 5085.923711144335, 5112.309838171874, 5140.717260550631, 5140.922886156711, 5157.355330583677, 6011.308699499614, 6030.7889223876955, 6040.4563589276295, 6063.151158837766, 6065.60573562717, 7383.520071195355, 7387.224341444071, 7390.7413240536325, 7420.072490938633, 7425.62871856405, 1505.6612262241126, 1694.542693283775, 1763.1360633289596, 1789.34688838573, 1791.113398867569, 1043.389617074005, 1085.2294870641774, 1086.9782604347868, 1089.7166736648528, 1095.6055819904827, 5532.446755324516, 5879.618289701916, 6933.826654333682, 6960.0, 6999.510034297652, 6883.552569083094, 7350.00774895393, 7543.622818859145, 7557.811054723676, 7575.431842611826, 6357.205349331333, 6921.238663746984, 7079.079719636415, 7080.964595177094, 7088.0785497884945, 3528.7353448491467, 4009.258287216874, 4032.0927791247323, 4043.3732771420478, 4044.2720310343834, 7459.291367320096, 8080.43436959419, 8088.555129467935, 8089.514629122272, 8117.387762445655, 7700.5379677218425, 7873.842523149619, 7936.087349954713, 7951.204879512003, 7956.801079973047, 8149.633266503021, 8164.0, 8205.384596155192, 8214.63034163464, 8220.794480138044, 6298.464630506458, 7714.4599878008, 7762.41781866351, 7771.33943614799, 7793.805154871174, 7494.437917156344, 7587.886181707389, 7600.1639819620905, 7615.771526854203, 7622.733204337822, 7715.074191097105, 8056.315213206943, 8108.432409731262, 8132.634031468717, 8159.26566609008, 4812.831550895702, 4821.807127714992, 4866.853994380174, 4890.853274401774, 4904.950950490449, 7617.771466856003, 7624.5425274483705, 7636.236376362319, 7638.541687498546, 7642.891780691657, 7278.272172782891, 7315.6342182889575, 7359.963200183965, 7368.926310736824, 7392.0, 7134.678939447634, 7380.225076367119, 7390.852182956203, 7399.297066778648, 7473.991011213634, 7136.357727804522, 7188.676509557187, 7199.892001619875, 7207.360283057023, 7211.67547460355, 7363.631818408951, 7387.002754628056, 7398.556086634604, 7409.481336306407, 7414.518056326321, 6349.9682501587195, 6948.826279343057, 7126.928730712627, 7230.493865429369, 7237.63811809418], "value": 5368.511073320139, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [717.9317964793344, 725.4341613541436, 754.4831790223694, 769.1731388757081, 791.9683212671493, 14032.859671403283, 15398.769018464718, 15511.0, 15621.375144994201, 15874.285657145441, 13537.593872183825, 14341.498047568337, 14696.926515367408, 14730.55808325752, 14757.966942314042, 799.6961154761183, 949.900260472649, 954.0316578672653, 956.7034219391976, 967.9806403871918, 979.6962941488126, 980.039561229995, 983.8179936711696, 984.517586382671, 986.6398764450995, 990.1286867556577, 991.3556188477511, 993.3344659078399, 1040.2146379483518, 1044.2377064742743, 1002.8796544414644, 1024.933379330345, 1033.7415646088477, 1036.1555332404141, 1036.4144258494002, 736.1313649893124, 738.04791818554, 764.9388048956071, 781.8123650323938, 782.5891407011308, 15150.621234469116, 15192.392304307925, 15235.466758663393, 15307.46423875159, 15628.843711562966, 12941.352932353439, 12967.0, 13128.0810343276, 13132.540361087411, 13138.540151094665, 10159.492025398775, 10347.586096556128, 10360.689179324632, 10430.16558675304, 10449.425281609509, 3542.2030043240065, 3575.856965721368, 3606.796622537269, 3643.362411577963, 3721.6836568891677, 85585.0, 86925.0, 87327.56336218341, 88735.0, 89153.0, 9731.659391921248, 9783.36408133469, 9786.217102631772, 9791.755206119904, 9893.802123957625, 21651.566968660853, 22061.22785702525, 22434.55130897373, 22537.774622253895, 22683.43291417695, 7683.807904802313, 7780.727674531364, 7892.329152022143, 8000.239977202156, 8082.555459449787, 4103.29672510094, 4126.793660316972, 4142.627163555234, 4198.9370159447635, 4418.823247070081, 3755.399136138205, 3758.210775737126, 3787.7727336359358, 3792.6965842732516, 3808.3716186828865, 589.7080944932201, 689.4243306838746, 689.5001124184926, 690.7340673840507, 710.499098135813, 487.70777346471726, 575.3556017260611, 606.5056978562545, 616.636184651058, 627.7457629659995, 8273.503589784512, 8307.584620768937, 8335.166483351617, 8349.707760228363, 8583.39916205872, 528.3659608469851, 545.7080461952916, 548.1674978231619, 612.9908051379233, 638.7445021991148, 3930.0960779020984, 3936.3701807710627, 3959.7822119783114, 4046.5751096135073, 4125.855595054159, 94416.52791736135, 94945.0, 95313.5234323824, 95523.0, 95669.04330956741, 81281.0, 81616.18383816085, 82649.58675206585, 82790.0, 82860.17139828645, 69520.6523967387, 69745.99999999898, 70425.64787176032, 71393.0, 73106.17234569178, 8291.626876790438, 8431.0, 8532.360072994426, 8662.133786621287, 8662.956685216534, 50222.0, 50905.0, 51179.0, 51736.74131629318, 51896.038766553866, 66876.33123668896, 68041.65979170073, 69099.0, 69723.0, 70334.64832675803, 11144.888551114385, 11158.832617510907, 11220.438978051228, 11417.0, 11497.252678575866, 11919.46362413676, 12168.634940951786, 12263.877361226274, 12327.876721232673, 12350.876491234972, 11460.598879039193, 11511.712207194887, 11527.654170374903, 11681.474333654836, 11785.116116291141, 9014.909850901407, 10255.07704306616, 10462.63380781669, 10576.84134737995, 10813.783724325627, 10904.12766978624, 10918.890811091787, 11413.942930285295, 11453.656390308304, 11597.478113484745, 9718.805623887623, 9759.024097590183, 9920.652777153055, 10152.949235253776, 10247.538860751432, 9730.939911246254, 9938.006199380005, 9985.850212246676, 10046.497675116068, 10051.497425128568], "value": 7121.607729587579, "unit": "score"}], "name": "dromaeo_css", "value": 7710.582768212369, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 112.0, 119.0, 117.0, 117.0, 132.0, 116.0, 115.0, 113.0, 115.0], "value": 117.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 127.0, 154.0, 210.0, 117.0, 165.0, 174.0, 136.0, 168.0, 126.0], "value": 152.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [196.0, 185.0, 234.0, 188.0, 191.0, 192.0, 274.0, 276.0, 202.0, 192.0], "value": 213.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 75.0, 74.0, 144.0, 57.0, 56.0, 56.0, 71.0, 123.0, 52.0], "value": 77.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 77.0, 151.0, 64.0, 64.0, 63.0, 125.0, 116.0, 119.0, 160.0], "value": 99.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 87.0, 89.0, 86.0, 89.0, 107.0, 135.0, 73.0, 137.0, 131.0], "value": 102.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 106.0, 98.0, 92.0, 153.0, 94.0, 94.0, 95.0, 121.0, 98.0], "value": 104.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 145.0, 107.0, 148.0, 141.0, 90.0, 90.0, 89.0, 118.0, 150.0], "value": 122.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 64.0, 64.0, 64.0, 65.0, 65.0, 64.0, 77.0, 61.0, 59.0], "value": 64.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 97.0, 109.0, 55.0, 69.0, 100.0, 97.0, 61.0, 68.0, 87.0], "value": 81.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 102.0, 106.0, 106.0, 105.0, 81.0, 79.0, 80.0, 86.0, 82.0], "value": 90.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [125.0, 147.0, 143.0, 160.0, 116.0, 142.0, 124.0, 156.0, 164.0, 136.0], "value": 141.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 163.0, 162.0, 172.0, 163.0, 165.0, 169.0, 163.0, 183.0, 150.0], "value": 165.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 67.0, 98.0, 80.0, 70.0, 68.0, 67.0, 67.0, 67.0, 67.0], "value": 71.9, "unit": "score"}], "name": "kraken", "value": 1604.2, "alertThreshold": 2.0}]} 10:36:53 INFO - Return code: 0 10:36:53 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 10:36:53 ERROR - # TBPL SUCCESS # 10:36:53 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:36:53 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:36:53 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:36:53 INFO - 2016-07-06 10:36:53.559 screenresolution[1681:10736] starting screenresolution argv=screenresolution get 10:36:53 INFO - 2016-07-06 10:36:53.561 screenresolution[1681:10736] Display 0: 1600x1200x32@60 10:36:53 INFO - 2016-07-06 10:36:53.567 screenresolution[1682:10739] starting screenresolution argv=screenresolution list 10:36:53 INFO - Available Modes on Display 0 10:36:53 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:36:53 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:36:53 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:36:53 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:36:53 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:36:53 INFO - Intel Iris: 10:36:53 INFO - Chipset Model: Intel Iris 10:36:53 INFO - Type: GPU 10:36:53 INFO - Bus: Built-In 10:36:53 INFO - VRAM (Dynamic, Max): 1536 MB 10:36:53 INFO - Vendor: Intel (0x8086) 10:36:53 INFO - Device ID: 0x0a2e 10:36:53 INFO - Revision ID: 0x0009 10:36:53 INFO - Displays: 10:36:53 INFO - Display: 10:36:53 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:36:53 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:36:53 INFO - Display Serial Number: 1600x1200 60 10:36:53 INFO - Main Display: Yes 10:36:53 INFO - Mirror: Off 10:36:53 INFO - Online: Yes 10:36:53 INFO - Rotation: Supported 10:36:53 INFO - Return code: 0 10:36:53 INFO - Running post-action listener: _resource_record_post_action 10:36:53 INFO - Running post-run listener: _resource_record_post_run 10:36:54 INFO - Total resource usage - Wall time: 1193s; CPU: 53.0%; Read bytes: 37033472; Write bytes: 494619648; Read time: 240; Write time: 1596 10:36:54 INFO - install - Wall time: 22s; CPU: 55.0%; Read bytes: 196645376; Write bytes: 184827904; Read time: 17279; Write time: 408 10:36:54 INFO - run-tests - Wall time: 1172s; CPU: 53.0%; Read bytes: 29928960; Write bytes: 299002880; Read time: 182; Write time: 1158 10:36:54 INFO - Running post-run listener: _upload_blobber_files 10:36:54 INFO - Blob upload gear active. 10:36:54 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:36:54 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 10:36:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:36:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:36:55 INFO - (blobuploader) - INFO - Open directory for files ... 10:36:55 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 10:36:55 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:36:55 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:36:56 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 10:36:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:36:56 INFO - (blobuploader) - INFO - Done attempting. 10:36:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 10:36:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:36:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:36:57 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 10:36:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:36:57 INFO - (blobuploader) - INFO - Done attempting. 10:36:57 INFO - (blobuploader) - INFO - Iteration through files over. 10:36:57 INFO - Return code: 0 10:36:57 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:36:57 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:36:57 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/2d1c318bf620715b9212e2cfc3c3397443787f0962e13394a4bf44604c216f9661c56d9e5210779fcaeee68940f51d13b95cfab88b709928dbdcb1b8cd18a98a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/845f34180125e8c82afd6b2a490d431431eb0387ec4259cc649454f47e329433454b9f56b02e72b23f538842662b9936caa124a40bd04f6d7408ee6698eacf00"} 10:36:57 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:36:57 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:36:57 INFO - Contents: 10:36:57 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/2d1c318bf620715b9212e2cfc3c3397443787f0962e13394a4bf44604c216f9661c56d9e5210779fcaeee68940f51d13b95cfab88b709928dbdcb1b8cd18a98a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/845f34180125e8c82afd6b2a490d431431eb0387ec4259cc649454f47e329433454b9f56b02e72b23f538842662b9936caa124a40bd04f6d7408ee6698eacf00"} 10:36:57 INFO - Running post-run listener: copy_logs_to_upload_dir 10:36:57 INFO - Copying logs to upload dir... 10:36:57 INFO - mkdir: /builds/slave/test/build/upload/logs 10:36:57 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1249.550457 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-07-06 10:36:57.385512) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-06 10:36:57.389157) ========= 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.77VrDODGrV/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.TXBqktLF78/Listeners TMPDIR=/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/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/Mozilla-Beta/sha512/2d1c318bf620715b9212e2cfc3c3397443787f0962e13394a4bf44604c216f9661c56d9e5210779fcaeee68940f51d13b95cfab88b709928dbdcb1b8cd18a98a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/845f34180125e8c82afd6b2a490d431431eb0387ec4259cc649454f47e329433454b9f56b02e72b23f538842662b9936caa124a40bd04f6d7408ee6698eacf00"} build_url:https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010750 build_url: 'https://queue.taskcluster.net/v1/task/ecVZCIF-RautzDUy1rSwjw/artifacts/public/build/firefox-48.0.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/2d1c318bf620715b9212e2cfc3c3397443787f0962e13394a4bf44604c216f9661c56d9e5210779fcaeee68940f51d13b95cfab88b709928dbdcb1b8cd18a98a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/845f34180125e8c82afd6b2a490d431431eb0387ec4259cc649454f47e329433454b9f56b02e72b23f538842662b9936caa124a40bd04f6d7408ee6698eacf00"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-06 10:36:57.425950) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 10:36:57.426656) ========= 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.77VrDODGrV/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.TXBqktLF78/Listeners TMPDIR=/var/folders/07/z5h29ykn58v73zfg5g95jh1r00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005016 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 10:36:57.478932) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-06 10:36:57.479757) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-06 10:36:57.480500) ========= ========= Total master_lag: 0.19 =========