builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0196 starttime: 1467770158.69 results: success (0) buildid: 20160705171423 builduid: a1cc2c7a45834e1db8084688e98aa01c revision: bfcca87598b2ca8e31094d587b7b5cd033ef9577 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-05 18:55:58.686128) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-05 18:55:58.686559) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-05 18:55:58.686854) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-05 18:55:58.738272) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 18:55:58.738591) ========= 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.yyyD8cBPJx/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.W61jGDsixJ/Listeners TMPDIR=/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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-05 18:55:58-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 10.0M=0.001s 2016-07-05 18:55:59 (10.0 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.456555 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 18:55:59.216887) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 18:55:59.217206) ========= 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.yyyD8cBPJx/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.W61jGDsixJ/Listeners TMPDIR=/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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.020905 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 18:55:59.265583) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 3 secs) (at 2016-07-05 18:55:59.265902) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev bfcca87598b2ca8e31094d587b7b5cd033ef9577 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev bfcca87598b2ca8e31094d587b7b5cd033ef9577 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.yyyD8cBPJx/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.W61jGDsixJ/Listeners TMPDIR=/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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-05 18:55:59,337 truncating revision to first 12 chars 2016-07-05 18:55:59,337 Setting DEBUG logging. 2016-07-05 18:55:59,338 attempt 1/10 2016-07-05 18:55:59,338 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/bfcca87598b2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-05 18:56:00,318 unpacking tar archive at: fx-team-bfcca87598b2/testing/mozharness/ program finished with exit code 0 elapsedTime=1.240581 ========= master_lag: 2.54 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 3 secs) (at 2016-07-05 18:56:03.044807) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-05 18:56:03.045118) ========= script_repo_revision: bfcca87598b2ca8e31094d587b7b5cd033ef9577 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-05 18:56:03.045514) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-05 18:56:03.045776) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-05 18:56:03.213852) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 25 secs) (at 2016-07-05 18:56:03.214173) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.yyyD8cBPJx/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.W61jGDsixJ/Listeners TMPDIR=/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:56:03 INFO - MultiFileLogger online at 20160705 18:56:03 in /builds/slave/test 18:56:03 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 18:56:03 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:56:03 INFO - {'append_to_log': False, 18:56:03 INFO - 'base_work_dir': '/builds/slave/test', 18:56:03 INFO - 'blob_upload_branch': 'Fx-Team', 18:56:03 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:56:03 INFO - 'branch': 'Fx-Team', 18:56:03 INFO - 'buildbot_json_path': 'buildprops.json', 18:56:03 INFO - 'config_files': ('talos/mac_config.py',), 18:56:03 INFO - 'default_actions': ('clobber', 18:56:03 INFO - 'read-buildbot-config', 18:56:03 INFO - 'download-and-extract', 18:56:03 INFO - 'populate-webroot', 18:56:03 INFO - 'create-virtualenv', 18:56:03 INFO - 'install', 18:56:03 INFO - 'run-tests'), 18:56:03 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:56:03 INFO - 'download_minidump_stackwalk': True, 18:56:03 INFO - 'download_symbols': 'ondemand', 18:56:03 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:56:03 INFO - 'tooltool.py': '/tools/tooltool.py', 18:56:03 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:56:03 INFO - '/tools/misc-python/virtualenv.py')}, 18:56:03 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:56:03 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:56:03 INFO - 'installer_path': 'installer.exe', 18:56:03 INFO - 'log_level': 'info', 18:56:03 INFO - 'log_name': 'talos', 18:56:03 INFO - 'log_to_console': True, 18:56:03 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 18:56:03 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 18:56:03 INFO - 'opt_config_files': (), 18:56:03 INFO - 'pip_index': False, 18:56:03 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 18:56:03 INFO - 'cmd': ('bash', 18:56:03 INFO - '-c', 18:56:03 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 18:56:03 INFO - 'enabled': True, 18:56:03 INFO - 'halt_on_failure': False, 18:56:03 INFO - 'name': 'check_screen_resolution'},), 18:56:03 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 18:56:03 INFO - 'cmd': ('bash', 18:56:03 INFO - '-c', 18:56:03 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 18:56:03 INFO - 'enabled': True, 18:56:03 INFO - 'halt_on_failure': False, 18:56:03 INFO - 'name': 'check_screen_resolution'},), 18:56:03 INFO - 'run_cmd_checks_enabled': True, 18:56:03 INFO - 'sps_profile': False, 18:56:03 INFO - 'sps_profile_interval': 0, 18:56:03 INFO - 'suite': 'dromaeojs', 18:56:03 INFO - 'system_bits': '32', 18:56:03 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:56:03 INFO - 'title': 't-yosemite-r7-0196', 18:56:03 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:56:03 INFO - 'use_talos_json': True, 18:56:03 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:56:03 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:56:03 INFO - 'work_dir': 'build'} 18:56:03 INFO - ##### 18:56:03 INFO - ##### Running clobber step. 18:56:03 INFO - ##### 18:56:03 INFO - Running pre-action listener: _resource_record_pre_action 18:56:03 INFO - Running main action method: clobber 18:56:03 INFO - rmtree: /builds/slave/test/build 18:56:03 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:56:04 INFO - Running post-action listener: _resource_record_post_action 18:56:04 INFO - ##### 18:56:04 INFO - ##### Finished clobber step (success) 18:56:04 INFO - ##### 18:56:04 INFO - ##### 18:56:04 INFO - ##### Running read-buildbot-config step. 18:56:04 INFO - ##### 18:56:04 INFO - Running pre-action listener: _resource_record_pre_action 18:56:04 INFO - Running main action method: read_buildbot_config 18:56:04 INFO - Using buildbot properties: 18:56:04 INFO - { 18:56:04 INFO - "project": "", 18:56:04 INFO - "product": "firefox", 18:56:04 INFO - "script_repo_revision": "production", 18:56:04 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 18:56:04 INFO - "repository": "", 18:56:04 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 18:56:04 INFO - "buildid": "20160705171423", 18:56:04 INFO - "pgo_build": "False", 18:56:04 INFO - "basedir": "/builds/slave/test", 18:56:04 INFO - "buildnumber": 792, 18:56:04 INFO - "slavename": "t-yosemite-r7-0196", 18:56:04 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 18:56:04 INFO - "platform": "yosemite_r7", 18:56:04 INFO - "scheduler": "tests-fx-team-macosx64-talos", 18:56:04 INFO - "branch": "fx-team", 18:56:04 INFO - "repo_path": "integration/fx-team", 18:56:04 INFO - "revision": "bfcca87598b2ca8e31094d587b7b5cd033ef9577", 18:56:04 INFO - "stage_platform": "macosx64", 18:56:04 INFO - "builduid": "a1cc2c7a45834e1db8084688e98aa01c", 18:56:04 INFO - "slavebuilddir": "test" 18:56:04 INFO - } 18:56:04 INFO - Found installer url https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg. 18:56:04 INFO - Running post-action listener: _resource_record_post_action 18:56:04 INFO - ##### 18:56:04 INFO - ##### Finished read-buildbot-config step (success) 18:56:04 INFO - ##### 18:56:04 INFO - ##### 18:56:04 INFO - ##### Running download-and-extract step. 18:56:04 INFO - ##### 18:56:04 INFO - Running pre-action listener: _resource_record_pre_action 18:56:04 INFO - Running main action method: download_and_extract 18:56:04 INFO - mkdir: /builds/slave/test/build/tests 18:56:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:56:04 INFO - https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 18:56:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.test_packages.json 18:56:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.test_packages.json 18:56:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.mac.test_packages.json 18:56:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.mac.test_packages.json'}, attempt #1 18:56:15 INFO - Downloaded 1199 bytes. 18:56:15 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.mac.test_packages.json 18:56:15 INFO - Using the following test package requirements: 18:56:15 INFO - {u'common': [u'firefox-50.0a1.en-US.mac.common.tests.zip'], 18:56:15 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.mac.common.tests.zip', 18:56:15 INFO - u'firefox-50.0a1.en-US.mac.cppunittest.tests.zip'], 18:56:15 INFO - u'gtest': [u'firefox-50.0a1.en-US.mac.common.tests.zip', 18:56:15 INFO - u'firefox-50.0a1.en-US.mac.gtest.tests.zip'], 18:56:15 INFO - u'jittest': [u'firefox-50.0a1.en-US.mac.common.tests.zip', 18:56:15 INFO - u'jsshell-mac.zip'], 18:56:15 INFO - u'mochitest': [u'firefox-50.0a1.en-US.mac.common.tests.zip', 18:56:15 INFO - u'firefox-50.0a1.en-US.mac.mochitest.tests.zip'], 18:56:15 INFO - u'mozbase': [u'firefox-50.0a1.en-US.mac.common.tests.zip'], 18:56:15 INFO - u'reftest': [u'firefox-50.0a1.en-US.mac.common.tests.zip', 18:56:15 INFO - u'firefox-50.0a1.en-US.mac.reftest.tests.zip'], 18:56:15 INFO - u'talos': [u'firefox-50.0a1.en-US.mac.common.tests.zip', 18:56:15 INFO - u'firefox-50.0a1.en-US.mac.talos.tests.zip'], 18:56:15 INFO - u'web-platform': [u'firefox-50.0a1.en-US.mac.common.tests.zip', 18:56:15 INFO - u'firefox-50.0a1.en-US.mac.web-platform.tests.zip'], 18:56:15 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.mac.common.tests.zip', 18:56:15 INFO - u'firefox-50.0a1.en-US.mac.xpcshell.tests.zip']} 18:56:15 INFO - Downloading packages: [u'firefox-50.0a1.en-US.mac.common.tests.zip'] for test suite category: common 18:56: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')]} 18:56:15 INFO - https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 18:56:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip 18:56:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip 18:56:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.mac.common.tests.zip 18:56:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.mac.common.tests.zip'}, attempt #1 18:56:28 INFO - Downloaded 18802538 bytes. 18:56:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:56:28 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 18:56:32 INFO - Return code: 0 18:56:32 INFO - Downloading packages: [u'firefox-50.0a1.en-US.mac.common.tests.zip', u'firefox-50.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 18:56: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')]} 18:56:32 INFO - https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 18:56:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip 18:56:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip 18:56:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.mac.common.tests.zip 18:56:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.mac.common.tests.zip'}, attempt #1 18:56:33 INFO - Downloaded 18802538 bytes. 18:56:33 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:56:33 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 18:56:37 INFO - Return code: 0 18:56:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:56:37 INFO - https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 18:56:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.talos.tests.zip 18:56:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.talos.tests.zip 18:56:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.mac.talos.tests.zip 18:56:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.mac.talos.tests.zip'}, attempt #1 18:56:38 INFO - Downloaded 14403333 bytes. 18:56:38 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:56:38 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 18:56:38 INFO - Return code: 0 18:56:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:56:38 INFO - https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 18:56:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg 18:56:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg 18:56:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-50.0a1.en-US.mac.dmg 18:56:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.mac.dmg'}, attempt #1 18:56:41 INFO - Downloaded 112487053 bytes. 18:56:41 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg 18:56:41 INFO - mkdir: /builds/slave/test/properties 18:56:41 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:56:41 INFO - Writing to file /builds/slave/test/properties/build_url 18:56:41 INFO - Contents: 18:56:41 INFO - build_url:https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg 18:56:42 INFO - Running post-action listener: _resource_record_post_action 18:56:42 INFO - Running post-action listener: set_extra_try_arguments 18:56:42 INFO - ##### 18:56:42 INFO - ##### Finished download-and-extract step (success) 18:56:42 INFO - ##### 18:56:42 INFO - ##### 18:56:42 INFO - ##### Running populate-webroot step. 18:56:42 INFO - ##### 18:56:42 INFO - Running pre-action listener: _resource_record_pre_action 18:56:42 INFO - Running main action method: populate_webroot 18:56:42 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:56:42 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:56:42 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:56:42 INFO - '--tppagecycles', 18:56:42 INFO - '7'], 18:56:42 INFO - 'tests': ['tsvgm']}}, 18:56:42 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:56:42 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 18:56:42 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['dromaeo_css', 'kraken']}, 18:56:42 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 18:56:42 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:56:42 INFO - 'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:56:42 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:56:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:56:42 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:56:42 INFO - 'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['damp', 'tps']}, 18:56:42 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:56:42 INFO - 'tests': ['damp', 'tps']}, 18:56:42 INFO - 'g3': {'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['dromaeo_dom']}, 18:56:42 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:56:42 INFO - 'g4': {'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['basic_compositor_video']}, 18:56:42 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 18:56:42 INFO - 'other': {'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['a11yr', 18:56:42 INFO - 'ts_paint', 18:56:42 INFO - 'tpaint', 18:56:42 INFO - 'sessionrestore', 18:56:42 INFO - 'sessionrestore_no_auto_restore', 18:56:42 INFO - 'tabpaint']}, 18:56:42 INFO - 'other-e10s': {'tests': ['a11yr', 18:56:42 INFO - 'ts_paint', 18:56:42 INFO - 'tpaint', 18:56:42 INFO - 'sessionrestore', 18:56:42 INFO - 'sessionrestore_no_auto_restore', 18:56:42 INFO - 'tabpaint']}, 18:56:42 INFO - 'other-e10s_l64': {'tests': ['a11yr', 18:56:42 INFO - 'ts_paint', 18:56:42 INFO - 'tpaint', 18:56:42 INFO - 'sessionrestore', 18:56:42 INFO - 'sessionrestore_no_auto_restore', 18:56:42 INFO - 'tabpaint']}, 18:56:42 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 18:56:42 INFO - 'ts_paint', 18:56:42 INFO - 'tpaint', 18:56:42 INFO - 'sessionrestore', 18:56:42 INFO - 'sessionrestore_no_auto_restore', 18:56:42 INFO - 'tabpaint']}, 18:56:42 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['a11yr', 18:56:42 INFO - 'ts_paint', 18:56:42 INFO - 'tpaint', 18:56:42 INFO - 'sessionrestore', 18:56:42 INFO - 'sessionrestore_no_auto_restore', 18:56:42 INFO - 'tabpaint']}, 18:56:42 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['a11yr', 18:56:42 INFO - 'ts_paint', 18:56:42 INFO - 'tpaint', 18:56:42 INFO - 'sessionrestore', 18:56:42 INFO - 'sessionrestore_no_auto_restore', 18:56:42 INFO - 'tabpaint']}, 18:56:42 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['tsvgx', 18:56:42 INFO - 'tsvgr_opacity', 18:56:42 INFO - 'tart', 18:56:42 INFO - 'tscrollx', 18:56:42 INFO - 'cart']}, 18:56:42 INFO - 'svgr-e10s': {'tests': ['tsvgx', 18:56:42 INFO - 'tsvgr_opacity', 18:56:42 INFO - 'tart', 18:56:42 INFO - 'tscrollx', 18:56:42 INFO - 'cart']}, 18:56:42 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:56:42 INFO - 'talos_options': ['--disable-e10s'], 18:56:42 INFO - 'tests': ['tp5o']}, 18:56:42 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:56:42 INFO - 'tests': ['tp5o']}, 18:56:42 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:56:42 INFO - 'talos_options': ['--disable-e10s', 18:56:42 INFO - '--xperf_path', 18:56:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:56:42 INFO - 'tests': ['tp5n']}, 18:56:42 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:56:42 INFO - 'talos_options': ['--xperf_path', 18:56:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:56:42 INFO - 'tests': ['tp5n']}}, 18:56:42 INFO - 'talos.zip': {'path': '', 18:56:42 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:56:42 INFO - Running post-action listener: _resource_record_post_action 18:56:42 INFO - ##### 18:56:42 INFO - ##### Finished populate-webroot step (success) 18:56:42 INFO - ##### 18:56:42 INFO - ##### 18:56:42 INFO - ##### Running create-virtualenv step. 18:56:42 INFO - ##### 18:56:42 INFO - Running pre-action listener: _resource_record_pre_action 18:56:42 INFO - Running main action method: create_virtualenv 18:56:42 INFO - Creating virtualenv /builds/slave/test/build/venv 18:56:42 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 18:56:42 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:56:42 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:56:42 INFO - Using real prefix '/tools/python27' 18:56:42 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:56:43 INFO - Installing distribute.............................................................................................................................................................................................done. 18:56:46 INFO - Installing pip.................done. 18:56:46 INFO - Return code: 0 18:56:46 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:56:46 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')]} 18:56:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:56:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56:46 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')]} 18:56:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:56:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56:46 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 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:56:46 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 18:56:46 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 18:56:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:56:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:56:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:56:46 INFO - 'HOME': '/Users/cltbld', 18:56:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:56:46 INFO - 'LOGNAME': 'cltbld', 18:56:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:56:46 INFO - 'MOZ_NO_REMOTE': '1', 18:56:46 INFO - 'NO_EM_RESTART': '1', 18:56:46 INFO - 'PAGER': '/bin/cat', 18:56:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:56:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:56:46 INFO - 'PWD': '/builds/slave/test', 18:56:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:56:46 INFO - 'SHELL': '/bin/bash', 18:56:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:56:46 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:56:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:56:46 INFO - 'USER': 'cltbld', 18:56:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:56:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:56:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:56:46 INFO - 'XPC_FLAGS': '0x0', 18:56:46 INFO - 'XPC_SERVICE_NAME': '0', 18:56:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:56:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:56:46 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 18:56:46 INFO - Cleaning up... 18:56:46 INFO - Return code: 0 18:56:46 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 18:56:46 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')]} 18:56:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:56:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56:46 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')]} 18:56:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:56:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:56:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 18:56:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 18:56:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:56:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:56:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:56:46 INFO - 'HOME': '/Users/cltbld', 18:56:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:56:46 INFO - 'LOGNAME': 'cltbld', 18:56:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:56:46 INFO - 'MOZ_NO_REMOTE': '1', 18:56:46 INFO - 'NO_EM_RESTART': '1', 18:56:46 INFO - 'PAGER': '/bin/cat', 18:56:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:56:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:56:46 INFO - 'PWD': '/builds/slave/test', 18:56:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:56:46 INFO - 'SHELL': '/bin/bash', 18:56:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:56:46 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:56:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:56:46 INFO - 'USER': 'cltbld', 18:56:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:56:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:56:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:56:46 INFO - 'XPC_FLAGS': '0x0', 18:56:46 INFO - 'XPC_SERVICE_NAME': '0', 18:56:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:56:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:56:46 INFO - Downloading/unpacking psutil>=3.1.1 18:56:46 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 18:56:46 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 18:56:46 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 18:56:46 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 18:56:46 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 18:56:46 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 18:56:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:56:49 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:56:49 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:56:49 INFO - Installing collected packages: psutil 18:56:49 INFO - Running setup.py install for psutil 18:56:49 INFO - building 'psutil._psutil_osx' extension 18:56:49 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 18:56:50 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 18:56:50 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 18:56:50 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 18:56:50 INFO - building 'psutil._psutil_posix' extension 18:56:50 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 18:56:50 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 18:56:50 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 18:56:50 INFO - ^ 18:56:50 INFO - 1 warning generated. 18:56:50 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 18:56:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:56:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:56:50 INFO - Successfully installed psutil 18:56:50 INFO - Cleaning up... 18:56:50 INFO - Return code: 0 18:56:50 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 18:56: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')]} 18:56:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:56:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56: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')]} 18:56:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:56:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:56: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 18:56: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 mozsystemmonitor==0.3 18:56:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:56:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:56:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:56:50 INFO - 'HOME': '/Users/cltbld', 18:56:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:56:50 INFO - 'LOGNAME': 'cltbld', 18:56:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:56:50 INFO - 'MOZ_NO_REMOTE': '1', 18:56:50 INFO - 'NO_EM_RESTART': '1', 18:56:50 INFO - 'PAGER': '/bin/cat', 18:56:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:56:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:56:50 INFO - 'PWD': '/builds/slave/test', 18:56:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:56:50 INFO - 'SHELL': '/bin/bash', 18:56:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:56:50 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:56:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:56:50 INFO - 'USER': 'cltbld', 18:56:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:56:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:56:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:56:50 INFO - 'XPC_FLAGS': '0x0', 18:56:50 INFO - 'XPC_SERVICE_NAME': '0', 18:56:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:56:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:56:50 INFO - Downloading/unpacking mozsystemmonitor==0.3 18:56:50 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 18:56:50 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 18:56:50 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 18:56:50 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 18:56:50 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 18:56:50 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 18:56:53 INFO - Downloading mozsystemmonitor-0.3.tar.gz 18:56:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:56:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 18:56:53 INFO - Installing collected packages: mozsystemmonitor 18:56:53 INFO - Running setup.py install for mozsystemmonitor 18:56:53 INFO - Successfully installed mozsystemmonitor 18:56:53 INFO - Cleaning up... 18:56:53 INFO - Return code: 0 18:56:53 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 18:56:53 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')]} 18:56:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:56:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56:53 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')]} 18:56:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:56:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:56:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 18:56:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 18:56:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:56:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:56:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:56:53 INFO - 'HOME': '/Users/cltbld', 18:56:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:56:53 INFO - 'LOGNAME': 'cltbld', 18:56:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:56:53 INFO - 'MOZ_NO_REMOTE': '1', 18:56:53 INFO - 'NO_EM_RESTART': '1', 18:56:53 INFO - 'PAGER': '/bin/cat', 18:56:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:56:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:56:53 INFO - 'PWD': '/builds/slave/test', 18:56:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:56:53 INFO - 'SHELL': '/bin/bash', 18:56:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:56:53 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:56:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:56:53 INFO - 'USER': 'cltbld', 18:56:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:56:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:56:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:56:53 INFO - 'XPC_FLAGS': '0x0', 18:56:53 INFO - 'XPC_SERVICE_NAME': '0', 18:56:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:56:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:56:53 INFO - Downloading/unpacking jsonschema==2.5.1 18:56: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 18:56: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 18:56: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 18:56: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 18:56: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 18:56: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 18:56:56 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:56:56 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 18:56:56 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 18:56:56 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 18:56:56 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 18:56:56 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 18:56:56 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 18:56:56 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 18:56:56 INFO - Downloading functools32-3.2.3-2.tar.gz 18:56:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 18:56:56 INFO - warning: no files found matching '*.txt' 18:56:56 INFO - no previously-included directories found matching 'build' 18:56:56 INFO - no previously-included directories found matching 'dist' 18:56:56 INFO - no previously-included directories found matching '.git*' 18:56:56 INFO - Installing collected packages: jsonschema, functools32 18:56:56 INFO - Running setup.py install for functools32 18:56:56 INFO - warning: no files found matching '*.txt' 18:56:56 INFO - no previously-included directories found matching 'build' 18:56:56 INFO - no previously-included directories found matching 'dist' 18:56:56 INFO - no previously-included directories found matching '.git*' 18:56:56 INFO - Successfully installed jsonschema functools32 18:56:56 INFO - Cleaning up... 18:56:57 INFO - Return code: 0 18:56:57 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:56:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:56:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:56:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:56:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:56:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:56:57 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 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:56:57 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 18:56:57 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 18:56:57 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:56:57 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:56:57 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:56:57 INFO - 'HOME': '/Users/cltbld', 18:56:57 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:56:57 INFO - 'LOGNAME': 'cltbld', 18:56:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:56:57 INFO - 'MOZ_NO_REMOTE': '1', 18:56:57 INFO - 'NO_EM_RESTART': '1', 18:56:57 INFO - 'PAGER': '/bin/cat', 18:56:57 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:56:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:56:57 INFO - 'PWD': '/builds/slave/test', 18:56:57 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:56:57 INFO - 'SHELL': '/bin/bash', 18:56:57 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:56:57 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:56:57 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:56:57 INFO - 'USER': 'cltbld', 18:56:57 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:56:57 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:56:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:56:57 INFO - 'XPC_FLAGS': '0x0', 18:56:57 INFO - 'XPC_SERVICE_NAME': '0', 18:56:57 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:56:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:56:57 INFO - Downloading/unpacking blobuploader==1.2.4 18:56: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 18:56: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 18:56: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 18:56: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 18:56: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 18:56: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 18:56:59 INFO - Downloading blobuploader-1.2.4.tar.gz 18:56:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:56:59 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:56:59 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 18:56:59 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 18:56:59 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 18:56:59 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 18:56:59 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 18:56:59 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 18:57:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:57:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:57:00 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 18:57:00 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 18:57:00 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 18:57:00 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 18:57:00 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 18:57:00 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 18:57:00 INFO - Downloading docopt-0.6.1.tar.gz 18:57:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:57:00 INFO - Installing collected packages: blobuploader, requests, docopt 18:57:00 INFO - Running setup.py install for blobuploader 18:57:01 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:57:01 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:57:01 INFO - Running setup.py install for requests 18:57:01 INFO - Running setup.py install for docopt 18:57:01 INFO - Successfully installed blobuploader requests docopt 18:57:01 INFO - Cleaning up... 18:57:01 INFO - Return code: 0 18:57:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:57:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:57:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:57:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:57:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:57:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:57:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:57:01 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 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:57:01 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 18:57:01 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 18:57:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:57:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:57:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:57:01 INFO - 'HOME': '/Users/cltbld', 18:57:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:57:01 INFO - 'LOGNAME': 'cltbld', 18:57:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:57:01 INFO - 'MOZ_NO_REMOTE': '1', 18:57:01 INFO - 'NO_EM_RESTART': '1', 18:57:01 INFO - 'PAGER': '/bin/cat', 18:57:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:57:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:57:01 INFO - 'PWD': '/builds/slave/test', 18:57:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:57:01 INFO - 'SHELL': '/bin/bash', 18:57:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:57:01 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:57:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:57:01 INFO - 'USER': 'cltbld', 18:57:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:57:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:57:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:57:01 INFO - 'XPC_FLAGS': '0x0', 18:57:01 INFO - 'XPC_SERVICE_NAME': '0', 18:57:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:57:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-ewHsHU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-1JuwQJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-hnIIVV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-PZW03k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-imQIzJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-bD6i74-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-byym9r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-szZIDI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:57:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:57:02 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-SMAsdn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:57:03 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-W5XYAZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:57:03 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-bLwqiA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:57:03 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-MNGDvQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:57:03 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-L7R4BV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:57:03 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-jVOL9a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:57:03 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-MzqwQP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:57:03 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-hDOU_j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:57:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:57:03 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-KXVgHx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:57:03 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:57:03 INFO - Running setup.py install for manifestparser 18:57:03 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:57:03 INFO - Running setup.py install for mozcrash 18:57:04 INFO - Running setup.py install for mozdebug 18:57:04 INFO - Running setup.py install for mozdevice 18:57:04 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 18:57:04 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:57:04 INFO - Running setup.py install for mozfile 18:57:04 INFO - Running setup.py install for mozhttpd 18:57:04 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:57:04 INFO - Running setup.py install for mozinfo 18:57:04 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:57:04 INFO - Running setup.py install for mozInstall 18:57:04 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:57:04 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:57:04 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:57:04 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:57:05 INFO - Running setup.py install for mozleak 18:57:05 INFO - Running setup.py install for mozlog 18:57:05 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:57:05 INFO - Running setup.py install for moznetwork 18:57:05 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:57:05 INFO - Running setup.py install for mozprocess 18:57:05 INFO - Running setup.py install for mozprofile 18:57:05 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:57:05 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:57:05 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:57:05 INFO - Running setup.py install for mozrunner 18:57:05 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:57:05 INFO - Running setup.py install for mozscreenshot 18:57:06 INFO - Running setup.py install for moztest 18:57:06 INFO - Running setup.py install for mozversion 18:57:06 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:57:06 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:57:06 INFO - Cleaning up... 18:57:06 INFO - Return code: 0 18:57:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:57:06 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')]} 18:57:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:57:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:57:06 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')]} 18:57:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:57:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:57:06 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 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:57:06 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 18:57:06 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 18:57:06 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:57:06 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:57:06 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:57:06 INFO - 'HOME': '/Users/cltbld', 18:57:06 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:57:06 INFO - 'LOGNAME': 'cltbld', 18:57:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:57:06 INFO - 'MOZ_NO_REMOTE': '1', 18:57:06 INFO - 'NO_EM_RESTART': '1', 18:57:06 INFO - 'PAGER': '/bin/cat', 18:57:06 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:57:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:57:06 INFO - 'PWD': '/builds/slave/test', 18:57:06 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:57:06 INFO - 'SHELL': '/bin/bash', 18:57:06 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:57:06 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:57:06 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:57:06 INFO - 'USER': 'cltbld', 18:57:06 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:57:06 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:57:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:57:06 INFO - 'XPC_FLAGS': '0x0', 18:57:06 INFO - 'XPC_SERVICE_NAME': '0', 18:57:06 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:57:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:57:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:57:06 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-ycjkET-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:57:06 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)) 18:57:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:57:06 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-ge6Riw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:57:06 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)) 18:57:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:57:06 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-EFlzWv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-HGe6af-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-VK5Y8K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-pK0wEg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-rB6dQ2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-yLBAJn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-ufuXRD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-2XJIbP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:57:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-3j5B0T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-hkAjmX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:57:07 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)) 18:57:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:57:07 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-uhdNpo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:57:08 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)) 18:57:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:57:08 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-V7I7QJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:57:08 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)) 18:57:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:57:08 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-RI8PMX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:57:08 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)) 18:57:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:57:08 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-9djaAY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:57:08 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)) 18:57:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:57:08 INFO - Running setup.py (path:/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/pip-NFBxQI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:57:08 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)) 18:57:08 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)) 18:57:08 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)) 18:57:08 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)) 18:57:08 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)) 18:57:08 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)) 18:57:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:57:08 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 18:57:08 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 18:57:08 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 18:57:08 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 18:57:08 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 18:57:08 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 18:57:11 INFO - Downloading blessings-1.6.tar.gz 18:57:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:57:11 INFO - Installing collected packages: blessings 18:57:11 INFO - Running setup.py install for blessings 18:57:11 INFO - Successfully installed blessings 18:57:11 INFO - Cleaning up... 18:57:11 INFO - Return code: 0 18:57:11 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:57:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:57:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:57:11 INFO - Reading from file tmpfile_stdout 18:57:11 INFO - Current package versions: 18:57:11 INFO - blessings == 1.6 18:57:11 INFO - blobuploader == 1.2.4 18:57:11 INFO - docopt == 0.6.1 18:57:11 INFO - functools32 == 3.2.3-2 18:57:11 INFO - jsonschema == 2.5.1 18:57:11 INFO - manifestparser == 1.1 18:57:11 INFO - mozInstall == 1.12 18:57:11 INFO - mozcrash == 0.17 18:57:11 INFO - mozdebug == 0.1 18:57:11 INFO - mozdevice == 0.48 18:57:11 INFO - mozfile == 1.2 18:57:11 INFO - mozhttpd == 0.7 18:57:11 INFO - mozinfo == 0.9 18:57:11 INFO - mozleak == 0.1 18:57:11 INFO - mozlog == 3.2 18:57:11 INFO - moznetwork == 0.27 18:57:11 INFO - mozprocess == 0.22 18:57:11 INFO - mozprofile == 0.28 18:57:11 INFO - mozrunner == 6.11 18:57:11 INFO - mozscreenshot == 0.1 18:57:11 INFO - mozsystemmonitor == 0.3 18:57:11 INFO - moztest == 0.7 18:57:11 INFO - mozversion == 1.4 18:57:11 INFO - psutil == 3.1.1 18:57:11 INFO - requests == 1.2.3 18:57:11 INFO - wsgiref == 0.1.2 18:57:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:57: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')]} 18:57:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:57:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:57: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')]} 18:57:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:57:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:57:11 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 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:57:11 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 18:57:11 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 18:57:11 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:57:11 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:57:11 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:57:11 INFO - 'HOME': '/Users/cltbld', 18:57:11 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:57:11 INFO - 'LOGNAME': 'cltbld', 18:57:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:57:11 INFO - 'MOZ_NO_REMOTE': '1', 18:57:11 INFO - 'NO_EM_RESTART': '1', 18:57:11 INFO - 'PAGER': '/bin/cat', 18:57:11 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:57:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:57:11 INFO - 'PWD': '/builds/slave/test', 18:57:11 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:57:11 INFO - 'SHELL': '/bin/bash', 18:57:11 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:57:11 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:57:11 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:57:11 INFO - 'USER': 'cltbld', 18:57:11 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:57:11 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:57:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:57:11 INFO - 'XPC_FLAGS': '0x0', 18:57:11 INFO - 'XPC_SERVICE_NAME': '0', 18:57:11 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:57:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 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)) 18:57:12 INFO - Cleaning up... 18:57:12 INFO - Return code: 0 18:57:12 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 18:57:12 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')]} 18:57:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:57:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:57:12 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')]} 18:57:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:57:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:57:12 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 0x10767da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107712618>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffac0d640f0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, '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.yyyD8cBPJx/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.W61jGDsixJ/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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 18:57:12 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 18:57:12 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 18:57:12 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:57:12 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:57:12 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:57:12 INFO - 'HOME': '/Users/cltbld', 18:57:12 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:57:12 INFO - 'LOGNAME': 'cltbld', 18:57:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:57:12 INFO - 'MOZ_NO_REMOTE': '1', 18:57:12 INFO - 'NO_EM_RESTART': '1', 18:57:12 INFO - 'PAGER': '/bin/cat', 18:57:12 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:57:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:57:12 INFO - 'PWD': '/builds/slave/test', 18:57:12 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:57:12 INFO - 'SHELL': '/bin/bash', 18:57:12 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:57:12 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:57:12 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:57:12 INFO - 'USER': 'cltbld', 18:57:12 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:57:12 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:57:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:57:12 INFO - 'XPC_FLAGS': '0x0', 18:57:12 INFO - 'XPC_SERVICE_NAME': '0', 18:57:12 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:57:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:57:12 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 18:57:12 INFO - Cleaning up... 18:57:12 INFO - Return code: 0 18:57:12 INFO - Running post-action listener: _resource_record_post_action 18:57:12 INFO - Running post-action listener: _start_resource_monitoring 18:57:12 INFO - Starting resource monitoring. 18:57:12 INFO - ##### 18:57:12 INFO - ##### Finished create-virtualenv step (success) 18:57:12 INFO - ##### 18:57:12 INFO - ##### 18:57:12 INFO - ##### Running install step. 18:57:12 INFO - ##### 18:57:12 INFO - Running pre-action listener: _resource_record_pre_action 18:57:12 INFO - Running main action method: install 18:57:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:57:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:57:12 INFO - Reading from file tmpfile_stdout 18:57:12 INFO - Detecting whether we're running mozinstall >=1.0... 18:57:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:57:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:57:12 INFO - Reading from file tmpfile_stdout 18:57:12 INFO - Output received: 18:57:12 INFO - Usage: mozinstall [options] installer 18:57:12 INFO - Options: 18:57:12 INFO - -h, --help show this help message and exit 18:57:12 INFO - -d DEST, --destination=DEST 18:57:12 INFO - Directory to install application into. [default: 18:57:12 INFO - "/builds/slave/test"] 18:57:12 INFO - --app=APP Application being installed. [default: firefox] 18:57:12 INFO - mkdir: /builds/slave/test/build/application 18:57:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 18:57:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 18:57:46 INFO - Reading from file tmpfile_stdout 18:57:46 INFO - Output received: 18:57:46 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 18:57:46 INFO - Running post-action listener: _resource_record_post_action 18:57:46 INFO - ##### 18:57:46 INFO - ##### Finished install step (success) 18:57:46 INFO - ##### 18:57:46 INFO - ##### 18:57:46 INFO - ##### Running run-tests step. 18:57:46 INFO - ##### 18:57:46 INFO - Running pre-action listener: _resource_record_pre_action 18:57:46 INFO - Running main action method: run_tests 18:57:46 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 18:57:46 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 18:57:46 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 18:57:46 INFO - 2016-07-05 18:57:46.858 screenresolution[2187:28096] starting screenresolution argv=screenresolution get 18:57:46 INFO - 2016-07-05 18:57:46.861 screenresolution[2187:28096] Display 0: 1600x1200x32@60 18:57:46 INFO - 2016-07-05 18:57:46.866 screenresolution[2188:28099] starting screenresolution argv=screenresolution list 18:57:46 INFO - Available Modes on Display 0 18:57:46 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 18:57:46 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 18:57:46 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 18:57:46 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 18:57:47 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 18:57:47 INFO - Intel Iris: 18:57:47 INFO - Chipset Model: Intel Iris 18:57:47 INFO - Type: GPU 18:57:47 INFO - Bus: Built-In 18:57:47 INFO - VRAM (Dynamic, Max): 1536 MB 18:57:47 INFO - Vendor: Intel (0x8086) 18:57:47 INFO - Device ID: 0x0a2e 18:57:47 INFO - Revision ID: 0x0009 18:57:47 INFO - Displays: 18:57:47 INFO - Display: 18:57:47 INFO - Resolution: 1600 x 1200 @ 60 Hz 18:57:47 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 18:57:47 INFO - Display Serial Number: 1600x1200 60 18:57:47 INFO - Main Display: Yes 18:57:47 INFO - Mirror: Off 18:57:47 INFO - Online: Yes 18:57:47 INFO - Rotation: Supported 18:57:47 INFO - Return code: 0 18:57:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:57:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:57:47 INFO - Python 2.7.3 18:57:47 INFO - Return code: 0 18:57:47 INFO - grabbing minidump binary from tooltool 18:57:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:57:47 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1075e1d30>, '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 0x107346db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1075d9b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:57:47 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 18:57:47 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 18:57:47 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 18:57:47 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:57:47 INFO - Return code: 0 18:57:47 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 18:57:47 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:57:47 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:57:47 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 18:57:47 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:57:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0196', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 18:57:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0196 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 18:57:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.yyyD8cBPJx/Render', 18:57:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 18:57:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 18:57:47 INFO - 'HOME': '/Users/cltbld', 18:57:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 18:57:47 INFO - 'LOGNAME': 'cltbld', 18:57:47 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:57:47 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 18:57:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:57:47 INFO - 'MOZ_NO_REMOTE': '1', 18:57:47 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:57:47 INFO - 'NO_EM_RESTART': '1', 18:57:47 INFO - 'PAGER': '/bin/cat', 18:57:47 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 18:57:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:57:47 INFO - 'PWD': '/builds/slave/test', 18:57:47 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:57:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 18:57:47 INFO - 'SHELL': '/bin/bash', 18:57:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.W61jGDsixJ/Listeners', 18:57:47 INFO - 'TMPDIR': '/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/', 18:57:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 18:57:47 INFO - 'USER': 'cltbld', 18:57:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 18:57:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 18:57:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:57:47 INFO - 'XPC_FLAGS': '0x0', 18:57:47 INFO - 'XPC_SERVICE_NAME': '0', 18:57:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 18:57:47 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0196', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 18:57:47 INFO - mozversion application_buildid: 20160705171423 18:57:47 INFO - mozversion application_changeset: bfcca87598b2ca8e31094d587b7b5cd033ef9577 18:57:47 INFO - mozversion application_display_name: Nightly 18:57:47 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:57:47 INFO - mozversion application_name: Firefox 18:57:47 INFO - mozversion application_remotingname: firefox 18:57:47 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 18:57:47 INFO - mozversion application_vendor: Mozilla 18:57:47 INFO - mozversion application_version: 50.0a1 18:57:47 INFO - mozversion platform_buildid: 20160705171423 18:57:47 INFO - mozversion platform_changeset: bfcca87598b2ca8e31094d587b7b5cd033ef9577 18:57:47 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 18:57:47 INFO - mozversion platform_version: 50.0a1 18:57:47 INFO - using testdate: 1467770267 18:57:47 INFO - actual date: 1467770267 18:57:47 INFO - starting webserver on 'localhost:57602' 18:57:47 INFO - SUITE-START | Running 2 tests 18:57:47 INFO - TEST-START | dromaeo_css 18:57:47 INFO - operating with platform_type : mac_ 18:57:47 INFO - Initialising browser for dromaeo_css test... 18:57:47 INFO - TEST-INFO | started process 2198 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/tmp6bDxWZ/profile http://localhost:57602/getInfo.html) 18:57:49 INFO - PROCESS | 2198 | __metrics Screen width/height:1600/1200 18:57:49 INFO - PROCESS | 2198 | colorDepth:24 18:57:49 INFO - PROCESS | 2198 | Browser inner width/height: 1024/689 18:57:49 INFO - PROCESS | 2198 | __metrics 18:57:49 INFO - PROCESS | 2198 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 18:57:49 INFO - PROCESS | 2198 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 18:57:50 INFO - TEST-INFO | 2198: exit 0 18:57:50 INFO - Browser initialized. 18:57:50 INFO - Running cycle 1/1 for dromaeo_css test... 18:57:50 INFO - TEST-INFO | started process 2200 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/tmp6bDxWZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:58:02 INFO - PROCESS | 2200 | RSS: Main: 243683328 18:58:02 INFO - PROCESS | 2200 | 18:58:53 INFO - PROCESS | 2200 | 1467770333779 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] 19:01:04 INFO - PROCESS | 2200 | Cycle 1(1): loaded http://localhost:57602/tests/dromaeo/cssquery-dojo.html (next: http://localhost:57602/tests/dromaeo/cssquery-ext.html) 19:01:06 INFO - PROCESS | 2200 | RSS: Main: 360513536 19:01:06 INFO - PROCESS | 2200 | 19:04:09 INFO - PROCESS | 2200 | Cycle 1(1): loaded http://localhost:57602/tests/dromaeo/cssquery-ext.html (next: http://localhost:57602/tests/dromaeo/cssquery-jquery.html) 19:04:09 INFO - PROCESS | 2200 | RSS: Main: 374362112 19:04:09 INFO - PROCESS | 2200 | 19:07:11 INFO - PROCESS | 2200 | Cycle 1(1): loaded http://localhost:57602/tests/dromaeo/cssquery-jquery.html (next: http://localhost:57602/tests/dromaeo/cssquery-mootools.html) 19:07:12 INFO - PROCESS | 2200 | RSS: Main: 373063680 19:07:12 INFO - PROCESS | 2200 | 19:10:14 INFO - PROCESS | 2200 | Cycle 1(1): loaded http://localhost:57602/tests/dromaeo/cssquery-mootools.html (next: http://localhost:57602/tests/dromaeo/cssquery-prototype.html) 19:10:15 INFO - PROCESS | 2200 | RSS: Main: 371220480 19:10:15 INFO - PROCESS | 2200 | 19:13:18 INFO - PROCESS | 2200 | Cycle 1(1): loaded http://localhost:57602/tests/dromaeo/cssquery-prototype.html (next: http://localhost:57602/tests/dromaeo/cssquery-yui.html) 19:13:19 INFO - PROCESS | 2200 | RSS: Main: 335282176 19:13:19 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | Cycle 1(1): loaded http://localhost:57602/tests/dromaeo/cssquery-yui.html (next: http://localhost:57602/tests/dromaeo/cssquery-dojo.html) 19:16:22 INFO - PROCESS | 2200 | RSS: Main: 430239744 19:16:22 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | __start_tp_report 19:16:22 INFO - PROCESS | 2200 | _x_x_mozilla_page_load 19:16:22 INFO - PROCESS | 2200 | _x_x_mozilla_page_load_details 19:16:22 INFO - PROCESS | 2200 | |i|pagename|runs| 19:16:22 INFO - PROCESS | 2200 | |0;dojo.html;2753.2566207124078;3369.258763072123;3398.88103916363;3402.1154499830045;3423.811690357031;5636.7181640918;5717.742701578429;5732.455416735414;5761.078227483604;5795;4951.752412379385;5712.371639119693;5736.827895163141;5893;5912.940870591293;5190.117679994391;5199.1161502544655;5249.737513124348;5270.7628156733035;5368.3021207243;5340.732963351837;5347.411784703699;5371.919421208666;5374.140137577989;5387.946120538803;5172.379314482268;5225.346831646044;5250.894982100336;5285.86785330366;5307.495787900143;5214.191800270964;5282.022825777243;5286.735663216824;5337.2527846101575;5375.489328513785;5191.610629202825;5199.506046925536;5214.869628259324;5299.099153143975;5311.893762124736;5770.9422905770825;5785.045467497858;5797.333306669745;5823.301203855522;5895.115732640095;6133.67132064549;6204.317525072239;6258;6268.717907694165;6293.685315734195;6282.497400208018;6314.305426403092;6316.74733010679;6347.143135676717;6357.17356743625;5834.753405682276;5850.473457388855;5854.853628659318;5892.998190307658;5901.2918449785875;5330.92003619946;6194.287656919422;6262.937370626236;6273.811785646438;6312.463440607508;6218.284897236786;6249.1563638908165;6269.592476489013;6270.090836828635;6278.215223097113;6307.590006649553;6310.5267104967315;6310.684465776692;6317.5893566918;6336.461400780985;6119.41115851624;6184.072389141665;6260.780872669435;6274.403931626488;6331.588446750947;6228.906566401508;6301.243850737941;6303.243610766737;6311.211098612674;6327.082573026885;4853.053654537332;4971.1549036663855;4974.427940786783;4982.177940639826;4998.475160108209;3857.9228415431535;4414;4422.778861056934;4431.7340959542535;4462.196804575207;5826.737796799154;5828.446297601721;5840.328362238312;5859.677717725566;5903.616264942765;6180.721867515973;6259.217597800275;6259.4679452246155;6259.593126446766;6277.748890044347;5717.42825717425;5786.797462088891;5794.072948328248;5832.212651292106;5887.735051922674;5462.2079798429;5482.314710661168;5483.013057649581;5489.039418101816;5492.395836457987;6243.843903902439;6432.260290066609;6448.32292609288;6458.063580780855;6459.257185423642;6245.937540624717;6270.498360131087;6312.084747711648;6313.747450101944;6314.810555683337;6399.904001440075;6419.903701444576;6423.100765892686;6424.582402144033;6429.7749578764515;6135.141080248858;6195.81412557624;6257.5932564383165;6270.310265870842;6277.874442511215;5545.556355491471;6046.788362407295;6223.782167624111;6257.186565746606;6276.435120839146;5580.77676892936;6155.507559395327;6182;6186.257649082139;6204.875902481835;4987.351644286365;6110.602810817282;6166.445019948226;6181.165542651865;6182.721777519932;5969.8806023878415;6023.789167379121;6067.7463934540465;6068.672341355384;6106.175666284995;6188.721507532082;6197.442230199304;6219.284782250099;6224.968875155595;6240.875182496416;5809.215755873072;5882.764689412375;5942.910856337072;6075.635461872302;6088.086786981989 19:16:22 INFO - PROCESS | 2200 | |1;ext.html;512.3083836820291;526.2816255810819;536.2010604199744;539.2235181338872;562.6427218716115;25490;31197.844010779943;32771;41466.378004329956;43554.346684799755;45345.41291054814;45725.77137114318;45935.16259349622;45941;45976;9173.220276276492;9312.882454105516;9702.029797020294;9879.407235565888;9912.008799120102;8763.78090547735;8958.820823583525;9703.61185552577;11852.466639001223;12053.156279060426;12047.216930899463;12059.3970301485;12126.636200913943;12149.210301330386;12150.878491215062;8808.427452215585;11993.94003029988;12052.57815976441;12096.455659495256;12101;8752.8687069694;8966.148215919542;8967.01362850086;11653.59212427561;11940.104492163036;42909.57090429087;43127.56872431267;43204.351934721;43232.78383608093;43291.56708432907;3522.119470132467;3604.6034936157002;3727.5713292971386;3740.532433445819;3827.9043023924346;32106;33588.6641133588;33740.987770366926;34256.82871585651;34410.82794586011;3266.9019929402157;3281.1305004173914;3317.303366293081;3393.474011528217;3402.9829850850833;549822;550533;555299;555786;555799;65848.67075664687;66637.00044499336;66765;66766.33233667698;66924.66537667377;71004.93492597615;71025.28974710187;71132;71135.6443217791;71235.6438217816;17365.7395139073;17674;17680.734788978174;17705.7344139838;17708.468745937644;12106.455209515418;12375.443105060294;13300;13431.261280629658;13494.93252533731;17158.571035724206;18144.253485894435;20073.397798066082;20192.798072019385;20299.797002030085;8230.465019773696;8317.542535160503;8329.750107496784;8350.369633565408;8359.247667709935;950.7005293332578;977.750673578233;989.3816364772017;1040.6149724601946;1098.9670309890716;26747.93008279647;29619.407611848073;31776.682233177373;31899.043028709177;32023;1090.574675876409;1117.8211486162174;1126.1272513801705;1193.6836738264367;1217.7807994561065;16308.918455407647;16365.836341636432;16373.67252654964;16491.752623710654;16874.915625421796;700643;709097.4545127344;712850;712861;714193;63620.363796361446;64073;64217;64227.35772642307;64400;1300.1808860417875;1417.433026789272;1432.6704857882746;1449.0653528473865;1457.3514785920377;31728.365432690756;32129.393530323858;32389.51415728813;32403.35193296168;32590.185245369055;53677.46322536881;53975.92048159093;54678;54746;54768.45231547634;465373.7313134262;482962;562460;563786;565311;24583.877080614482;27335;27791;27791.44417111606;28957.42085158243;49827.75086124546;50022.749886250334;50616.74691626518;51589;51771.74114129405;41682.58317416787;41866;41905.37141942812;42946.57053429426;43188;40319;41097.97255068647;42594.22602352762;42813.57186428096;43016.56983430251;40416.79791601023;41180.58819411768;41541.79229103835;41593.54422595195;41707.16585668331;36433.9069827895;36509.08727281733;37036.81481592575;37515.81242093772;37597;24303.05575553916;25761.742382575936;26884;26906.461870762083;27210.45579088447 19:16:22 INFO - PROCESS | 2200 | |2;jquery.html;329.89443378119006;367.65991457901436;392.7093950476647;400.0678419283069;418.76339867974593;15951.282192301345;16190.109543975077;20371.99999999998;21240.044198011088;21844.563108737857;21881.890590547064;22083.227087051957;22595.322140335775;22839.54320913581;22883.084676612914;5783.913241301373;5994.340622531518;6029.849253768669;6036.637801731888;6044.697765111749;5536.944630553703;5853;5862.794802181925;5866.823995280127;5878.118282257653;5736.541076713874;5791.10237913122;5796.333421656522;5812.186293918855;5814.796482123126;5692.943070569283;5839.065749480063;5858.648481091148;5866.530677545786;5870.559708021916;4906.165951788169;5013.598912087061;5019.799208031674;5107.591392688576;5150.948490515084;27205;27218.727812721816;27468.313292167655;27469.626518673987;27639.447211055867;2237.6830594580074;2366.786989170983;2473.323019556506;2503.198976327576;2521.823472356936;15745.448909288234;16043.083900226706;16393;16533.58666033347;16599.751003734953;1831.6519861226457;1886.8490520758307;1894.2707057782852;1899.1833511590012;1966.7541557305337;122119;124032;127045;127893;128895;8031.477953932976;10494.212934029978;10705.411202383944;10905.509252083675;11269.380184089954;12821.679458013437;13569.118007329493;13585.728285434236;13926;13947;7382.704691812267;8570.528620925785;8795.472271663593;8842.115788421106;8961.059088795713;8928.15182557656;8933;8951.194392504705;9043.773905652411;9051.81896362069;5755;6668.533202675766;6731.730730770812;6742;6784.219814721271;1809.746635471035;1831.9450416487527;1848.0944337274639;1848.159087615132;1849.6208277303122;916.2440986186423;940.3135710931059;978.9461579613189;1015.4364327798143;1045.1116550931647;22808.771912280667;23147.842607869537;23225.419364515685;23325.300240992798;23375.064997400255;948.7106432538004;969.5007071358256;991.2417000994245;1004.8944860789658;1048.7849990751877;10778.353298802096;11414.600488982845;11622.6513204604;12286.508539658313;12396.938015309866;551270;576920;597844.0215597876;607311;633857;110970;111725;113040.43479782548;122901;127277;1048.6591857646295;1049.2969710294121;1050.7635781949152;1052.4369462337613;1074.006543946846;20429.978501075184;20703.86984033689;20776.48058798542;20934.16263349449;21000.894995524926;55085.173722393396;56772.86454270974;56835;57230;57824;80510.00915349892;80544;80776.59611701904;80813.3837323262;81230.59384703038;5529.944700553104;5810.448007439287;8094.10964793884;8125.530957973209;8490.745277641681;13460.326983650973;13754.466057959427;13792.241426721226;13859.376328065462;13895.513657021957;11691.240069395462;11738;11902.880971190178;11913.761724765283;11930.880691193324;11694.064474842162;11752.353620550952;11753.177277590486;11763.529458821551;11945.04439644809;11830.349330786888;11836.70408239801;11924;11975.580854670045;12055.397230138633;7603.467757256939;7659.6212681717825;8085.555294458626;8325.583720813815;8330.458520196167;11807.409629518317;11875.406229688653;11997.700057498632;12035.638930832089;12061.035117190428 19:16:22 INFO - PROCESS | 2200 | |3;mootools.html;1398.713263780925;1548.3974086820144;1582.2247098921528;1772.175938188742;1904.2002359009214;7871.370290376771;8689.956550217248;8911.064338244472;8945.642174313036;9074.909250907489;8629.05080441151;8889;8898.421602595827;8905.975812781531;8918.108189181095;2007.9397618071407;2397.19693902542;2400.4478969836946;2400.7719266669724;2402.0992127952018;2341.6838726771925;2385.1771138957033;2386.069432921162;2388.199953015742;2393.7127544694663;2337.532493501298;2349.5888219561593;2363.243761996162;2373.5134297468976;2376.786089251967;2313.7223533175957;2345.7419683834764;2346.272655476808;2351.0830775997374;2358.433975845793;2312.988435057831;2322.7909488146147;2323.1404380379367;2325.058351367682;2329.8485598436046;8830.779230519223;8915.019347871728;8938.776530586787;8981.955090224506;9067.863982040275;5336.332958380202;5480.424555421663;5485.4788795064405;5489.6980666063355;5492.80775172871;3352.8155951422664;3607.8196090195647;3668.743187976843;3708.87018954338;3711.962880371189;1100.4167791070745;1105.4307031878589;1107.6123356825128;1125.5047778977223;1126.4480404601768;11680;11760.411979401082;11761.470733817;11767.646970590897;11836.349000804952;4374.4531933508315;4394.868153955386;4589.885252868705;4600.838970636011;4601.4248218972625;9149.130832570896;9160.267178625694;9162;9167.541622918827;9170.633174673072;5226.973865130726;5241.73791310433;5242.7640756166065;5248.711320877312;5250.343707036621;4395.648348132142;4545.454545454567;4792.2092854678585;4930.383702037246;4949.678270912379;3784;3794.5256842894637;3872.5546562145714;3903.1608204236227;3909.2181563687377;1013.5084484025242;1173.3194747046864;1181.1200655511527;1197.7604479104214;1202.3627477436971;672.5897202706345;849.3247867944998;904.8326059678981;958.4297343080856;979.7893452907516;5235.345581802275;5814;5982.4017598239825;6131.570790044654;6256.061590761422;486.13468026912153;487.8365747474565;498.1804930888668;502.84663177730414;640.5420124610926;3904.90237744053;4098.344264917599;4127.731697439657;4134.896627584334;4165.729227600196;10673.786524269472;10875.728106797234;11166.832497512543;11169.44152792357;11182.273152245078;11104.666859994213;11112.111031117653;11117.55529778816;11129.332240065622;11134.665960021212;7942.245486678757;8193.303569196685;8294.792630184173;8340.457870238415;8364.121767214476;6045.455908968214;6068.6358818471035;6154.723037463235;6237.656928868956;6260.780872669617;9958.502074896081;10215.795684086424;10468.68593942183;10471.94764026175;10520.842187367349;10132.74668133273;10436.63471778484;10494.68515944523;10500.789984200426;10556.313839600401;7633.618319084135;7722.266384693445;7795.532268063935;7799.922000780147;7808.102068261996;8201.548914809742;8449;8480.830383392175;8481.40630155883;8484.448510846774;5674.914876276942;6786.524943254122;7513.060867391576;7581.324224490484;7836.764897053097;7456.627168641655;7521.586312752632;7529.13414957265;7600.733974311093;7649.694012239448;7077.398421134261;7118.359347658736;7159.391451726661;7171.103612048494;7181.245969173162;4559.361689363558;4940.481249468754;5089.949100508948;5127;5169.224616307584;5134;5202.375714914235;5260.368755749335;5269.314989051399;5394.379646340721 19:16:22 INFO - PROCESS | 2200 | |4;prototype.html;297.9999999999999;305.70804881338324;313.55944897419135;315.87680804486257;317.6458249052306;5420.756065977031;5477.643953143043;5482.972585137074;5486.396496385394;5496.340439147308;4982.1957419606115;5153.6392452528335;5328.200769884519;5340.279062326585;5462.20797984292;3348.8827891023757;3638.3621874141168;4174.891679701762;4210.894727631803;4213.747175169499;4123.793810309473;4172.395002724618;4191.727537710054;4198.3282674772045;4212.452381190456;4049.995252350091;4057.9391309130388;4164.541900390955;4186.120914607921;4198.3282674772045;4126.628603425676;4151.252774500589;4154.854580089713;4175.749455032693;4179.895502612429;3599.6220396858216;3600.747947643666;3609.8014609196484;3616.710663146942;3628.455731640249;4353.62994145498;4419.447569053868;5282;5293.947060529384;5344;4523.665518671966;4595.172868883599;4638.582527572501;4663.580277774982;4664.580187783082;4872.975635121802;5140.7172605506685;5218.947810521884;5638.210650508932;5705.432555350068;3437.5187473753695;3851.5185601799776;3852.667442662077;3868.052327179859;3875.0893540018074;5076.670016448919;5960.493358064569;5960.791372301992;5972.50687328168;5981.401859814027;3179.9364012719616;3466.878659246914;3820.675242604354;3837.8529605723597;3895.5909629488497;3545.7163426925786;3934.8229329680235;3945.835978386383;3965.6232657897453;3996.680265578747;3827.8660246891227;4113.773742444194;4496.066691322697;4596.701214421052;4597.678162528591;4949.356583644103;5483.890322193533;5660.037793575102;5717;5767.567432442584;1180.6812160716559;1231.969200769988;1244.4710997825887;1318.775808112623;1355.959321220365;769.4806005945964;854.8461276970205;871.6034204436966;874.4709450782185;878.7759121423996;4654.720716757005;4903.239997800347;4989.226669866177;5098.694078355311;5376.1935709643085;5307.973460132752;5348.572114230852;5626.549876009909;5728.971355143198;5809.680467574324;4264.829406823692;5036.32009678696;5262.7631756571045;5265.368155821326;5330.733463326818;2208.403730992623;2262.547490501873;2430.4774473488283;2499.962500562493;2596.792256619466;4350.042480883615;4389.84635537761;4682.74244916526;5021.213226659239;5093.752030752489;4172.9359013451985;4907.111466240454;4953.847998082027;4980.203167493184;5027.2207807789855;4949.406071271471;5727.05503591911;6151.508639001122;6159.72281247336;6229.7508099676415;5285.312909321764;5306.434601792404;5918.585699001201;5983.790567330297;5999.340072591924;5165.896682066413;5578.609497335147;5836.678982655825;5901.3213480450295;5922.407759224043;5128.8461346159675;5430.212619170277;5822.3304320003745;5954.320555750017;6173.69131543412;3518.472229165646;4069.659945531272;4115.9176816464105;4117.508907111154;4138.937915931203;5008.449070602303;5448.509634132947;5588.30146231721;5724.971375143097;5888;4521.683482156218;5503.559715222853;5660.924424359358;5735.7418916148035;5795.913880714171;5255.290535777774;5630.016091471527;5720.3707592164;5783.479486846204;5798.449147330997;4549.45406551216;4905.950940490549;5325.854941187508;5640.661560306395;5649.5762817789655;5712.429406767054;5745.213571417776;5749.597528172988;5761.395053519488;5789.421057894346;5619.550435965195;5625.578081643811;5635.239242702182;5711.485966263056;5720.256366672306 19:16:22 INFO - PROCESS | 2200 | |5;yui.html;731.4989232375823;745.3254804402018;756.5007095317088;757.5114051436823;760.5511500591375;15139.470118545853;16311.265993030313;16336.18319084047;16340.019598824065;16346.509604711862;14834.55496335109;15052.322645480952;15055.698886022274;15058.021228620159;15081.698366032673;718.6227230703884;905.3164860530323;905.4567259644226;909.9772505687378;912.6851236323491;726.5422783646295;750.6997201119568;898.6899519665704;923.5151545438631;930.4975313330827;955.9904400956005;969.5733877094056;969.6848524229619;969.7769513012012;972.9027097290285;963.9566219520138;964.4165280005636;968.8110818390417;969.3989726369625;971.7522031881825;564.5540023381565;572.084664536742;584.211314725122;585.0960266388397;694.1531331775226;15393.076415415111;15544.689106217926;15547.689046219126;15563.299651515596;15571.922140389226;14348.354324055443;14563.635909102251;14608;14730.852691473163;15031.323590438456;12085.335306558136;12337;12442.81335779964;12530.373481325989;12578.433970471351;4540.682152249344;4604.723716577016;4680.672352935296;4785;4841.080194762983;115011.42494287476;124748.37625811904;124935;125329.12006319912;125659;11484.310941343547;11612.245204061708;11664.88335116638;11774.764504709858;11967.40162991847;23589.05643774264;23599.88200058989;23634.05463781464;23662.4084397888;23671.93476293571;7909.288164065261;7911.643976021093;7913.366930645535;8083.312918401884;8133.75598732039;3809.799913027443;4348.043430445297;4430.933535996963;4433.334999750064;4592.7014744041535;3497.755157138976;3580.946285805715;3614.6204648512053;3615.2769446110883;3619.3123306571665;649.2792999770252;654.0255020020136;657.5101549345673;660.8744338575656;669.3707914560298;596.0760820727854;608.4068033667139;609.0894113300644;644.7087617711609;659.9340065993363;8747.956260218658;8783.604737786814;9016.143466370684;9036.186743193144;9110.27117830572;550.4577990679178;573.3005733005726;578.6383510306059;619.7348690536008;636.147562266565;4416.205083085076;4443.711158774734;4451.421315228999;4501.774911254424;4561.270196768501;162031;164236;165278;165336;165767;128023;139762;143635;145666.2716686431;147757.26121369324;106104;121619;124146.3792681067;124279.37860310821;125356.37321813333;8233.723772815223;8684.175003374668;8692.695755648521;8802.899637545306;8908.198262156437;59878;62572.06141907784;65168.67415662891;65658.67170664307;65867.34132658612;97177;99058.50470747601;101198;102659.486702566;105275.42086868857;13341.266230357423;13343.466261349826;13531.526396576073;13791;14244.430222790972;15146.545603631908;15403.537893863202;15432.22838858075;15724.528264152093;16123.032618042955;14150.78773818414;14493;14555.345009474811;14586.781198281822;15046.398144074552;13978.510752123628;14162.99025068945;14283.64290892736;14342.354594043085;14505.347259373142;13825.930870345584;14081.155130692192;14374.712505749618;14493.275336232935;14597.197154156624;11399.20205585601;11550.653480395602;11602.825957610474;11630.476628551905;11755.941220293844;11347.092232621206;11501.48243329069;11584.652460426201;11685.591004314809;11818.40907954616 19:16:22 INFO - PROCESS | 2200 | __end_tp_report 19:16:22 INFO - PROCESS | 2200 | __start_cc_report 19:16:22 INFO - PROCESS | 2200 | _x_x_mozilla_cycle_collect,1146 19:16:22 INFO - PROCESS | 2200 | __end_cc_report 19:16:22 INFO - PROCESS | 2200 | __startTimestamp1467771382846__endTimestamp 19:16:22 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | ------- Summary: start ------- 19:16:22 INFO - PROCESS | 2200 | Number of tests: 6 19:16:22 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | [#0] dojo.html Cycles:165 Average:5780.22 Median:5969.88 stddev:672.40 (11.3%) stddev-sans-first:631.15 19:16:22 INFO - PROCESS | 2200 | Values: 2753.3 3369.3 3398.9 3402.1 3423.8 5636.7 5717.7 5732.5 5761.1 5795.0 4951.8 5712.4 5736.8 5893.0 5912.9 5190.1 5199.1 5249.7 5270.8 5368.3 5340.7 5347.4 5371.9 5374.1 5387.9 5172.4 5225.3 5250.9 5285.9 5307.5 5214.2 5282.0 5286.7 5337.3 5375.5 5191.6 5199.5 5214.9 5299.1 5311.9 5770.9 5785.0 5797.3 5823.3 5895.1 6133.7 6204.3 6258.0 6268.7 6293.7 6282.5 6314.3 6316.7 6347.1 6357.2 5834.8 5850.5 5854.9 5893.0 5901.3 5330.9 6194.3 6262.9 6273.8 6312.5 6218.3 6249.2 6269.6 6270.1 6278.2 6307.6 6310.5 6310.7 6317.6 6336.5 6119.4 6184.1 6260.8 6274.4 6331.6 6228.9 6301.2 6303.2 6311.2 6327.1 4853.1 4971.2 4974.4 4982.2 4998.5 3857.9 4414.0 4422.8 4431.7 4462.2 5826.7 5828.4 5840.3 5859.7 5903.6 6180.7 6259.2 6259.5 6259.6 6277.7 5717.4 5786.8 5794.1 5832.2 5887.7 5462.2 5482.3 5483.0 5489.0 5492.4 6243.8 6432.3 6448.3 6458.1 6459.3 6245.9 6270.5 6312.1 6313.7 6314.8 6399.9 6419.9 6423.1 6424.6 6429.8 6135.1 6195.8 6257.6 6270.3 6277.9 5545.6 6046.8 6223.8 6257.2 6276.4 5580.8 6155.5 6182.0 6186.3 6204.9 4987.4 6110.6 6166.4 6181.2 6182.7 5969.9 6023.8 6067.7 6068.7 6106.2 6188.7 6197.4 6219.3 6225.0 6240.9 5809.2 5882.8 5942.9 6075.6 6088.1 19:16:22 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | [#1] ext.html Cycles:180 Average:74266.89 Median:41139.28 stddev:161160.01 (391.7%) stddev-sans-first:161516.97 19:16:22 INFO - PROCESS | 2200 | Values: 512.3 526.3 536.2 539.2 562.6 25490.0 31197.8 32771.0 41466.4 43554.3 45345.4 45725.8 45935.2 45941.0 45976.0 9173.2 9312.9 9702.0 9879.4 9912.0 8763.8 8958.8 9703.6 11852.5 12053.2 12047.2 12059.4 12126.6 12149.2 12150.9 8808.4 11993.9 12052.6 12096.5 12101.0 8752.9 8966.1 8967.0 11653.6 11940.1 42909.6 43127.6 43204.4 43232.8 43291.6 3522.1 3604.6 3727.6 3740.5 3827.9 32106.0 33588.7 33741.0 34256.8 34410.8 3266.9 3281.1 3317.3 3393.5 3403.0 549822.0 550533.0 555299.0 555786.0 555799.0 65848.7 66637.0 66765.0 66766.3 66924.7 71004.9 71025.3 71132.0 71135.6 71235.6 17365.7 17674.0 17680.7 17705.7 17708.5 12106.5 12375.4 13300.0 13431.3 13494.9 17158.6 18144.3 20073.4 20192.8 20299.8 8230.5 8317.5 8329.8 8350.4 8359.2 950.7 977.8 989.4 1040.6 1099.0 26747.9 29619.4 31776.7 31899.0 32023.0 1090.6 1117.8 1126.1 1193.7 1217.8 16308.9 16365.8 16373.7 16491.8 16874.9 700643.0 709097.5 712850.0 712861.0 714193.0 63620.4 64073.0 64217.0 64227.4 64400.0 1300.2 1417.4 1432.7 1449.1 1457.4 31728.4 32129.4 32389.5 32403.4 32590.2 53677.5 53975.9 54678.0 54746.0 54768.5 465373.7 482962.0 562460.0 563786.0 565311.0 24583.9 27335.0 27791.0 27791.4 28957.4 49827.8 50022.7 50616.7 51589.0 51771.7 41682.6 41866.0 41905.4 42946.6 43188.0 40319.0 41098.0 42594.2 42813.6 43016.6 40416.8 41180.6 41541.8 41593.5 41707.2 36433.9 36509.1 37036.8 37515.8 37597.0 24303.1 25761.7 26884.0 26906.5 27210.5 19:16:22 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | [#2] jquery.html Cycles:180 Average:35482.33 Median:23186.63 stddev:99097.17 (427.4%) stddev-sans-first:99340.01 19:16:22 INFO - PROCESS | 2200 | Values: 329.9 367.7 392.7 400.1 418.8 15951.3 16190.1 20372.0 21240.0 21844.6 21881.9 22083.2 22595.3 22839.5 22883.1 5783.9 5994.3 6029.8 6036.6 6044.7 5536.9 5853.0 5862.8 5866.8 5878.1 5736.5 5791.1 5796.3 5812.2 5814.8 5692.9 5839.1 5858.6 5866.5 5870.6 4906.2 5013.6 5019.8 5107.6 5150.9 27205.0 27218.7 27468.3 27469.6 27639.4 2237.7 2366.8 2473.3 2503.2 2521.8 15745.4 16043.1 16393.0 16533.6 16599.8 1831.7 1886.8 1894.3 1899.2 1966.8 122119.0 124032.0 127045.0 127893.0 128895.0 8031.5 10494.2 10705.4 10905.5 11269.4 12821.7 13569.1 13585.7 13926.0 13947.0 7382.7 8570.5 8795.5 8842.1 8961.1 8928.2 8933.0 8951.2 9043.8 9051.8 5755.0 6668.5 6731.7 6742.0 6784.2 1809.7 1831.9 1848.1 1848.2 1849.6 916.2 940.3 978.9 1015.4 1045.1 22808.8 23147.8 23225.4 23325.3 23375.1 948.7 969.5 991.2 1004.9 1048.8 10778.4 11414.6 11622.7 12286.5 12396.9 551270.0 576920.0 597844.0 607311.0 633857.0 110970.0 111725.0 113040.4 122901.0 127277.0 1048.7 1049.3 1050.8 1052.4 1074.0 20430.0 20703.9 20776.5 20934.2 21000.9 55085.2 56772.9 56835.0 57230.0 57824.0 80510.0 80544.0 80776.6 80813.4 81230.6 5529.9 5810.4 8094.1 8125.5 8490.7 13460.3 13754.5 13792.2 13859.4 13895.5 11691.2 11738.0 11902.9 11913.8 11930.9 11694.1 11752.4 11753.2 11763.5 11945.0 11830.3 11836.7 11924.0 11975.6 12055.4 7603.5 7659.6 8085.6 8325.6 8330.5 11807.4 11875.4 11997.7 12035.6 12061.0 19:16:22 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | [#3] mootools.html Cycles:180 Average:5756.99 Median:4935.43 stddev:3277.91 (66.4%) stddev-sans-first:3270.74 19:16:22 INFO - PROCESS | 2200 | Values: 1398.7 1548.4 1582.2 1772.2 1904.2 7871.4 8690.0 8911.1 8945.6 9074.9 8629.1 8889.0 8898.4 8906.0 8918.1 2007.9 2397.2 2400.4 2400.8 2402.1 2341.7 2385.2 2386.1 2388.2 2393.7 2337.5 2349.6 2363.2 2373.5 2376.8 2313.7 2345.7 2346.3 2351.1 2358.4 2313.0 2322.8 2323.1 2325.1 2329.8 8830.8 8915.0 8938.8 8982.0 9067.9 5336.3 5480.4 5485.5 5489.7 5492.8 3352.8 3607.8 3668.7 3708.9 3712.0 1100.4 1105.4 1107.6 1125.5 1126.4 11680.0 11760.4 11761.5 11767.6 11836.3 4374.5 4394.9 4589.9 4600.8 4601.4 9149.1 9160.3 9162.0 9167.5 9170.6 5227.0 5241.7 5242.8 5248.7 5250.3 4395.6 4545.5 4792.2 4930.4 4949.7 3784.0 3794.5 3872.6 3903.2 3909.2 1013.5 1173.3 1181.1 1197.8 1202.4 672.6 849.3 904.8 958.4 979.8 5235.3 5814.0 5982.4 6131.6 6256.1 486.1 487.8 498.2 502.8 640.5 3904.9 4098.3 4127.7 4134.9 4165.7 10673.8 10875.7 11166.8 11169.4 11182.3 11104.7 11112.1 11117.6 11129.3 11134.7 7942.2 8193.3 8294.8 8340.5 8364.1 6045.5 6068.6 6154.7 6237.7 6260.8 9958.5 10215.8 10468.7 10471.9 10520.8 10132.7 10436.6 10494.7 10500.8 10556.3 7633.6 7722.3 7795.5 7799.9 7808.1 8201.5 8449.0 8480.8 8481.4 8484.4 5674.9 6786.5 7513.1 7581.3 7836.8 7456.6 7521.6 7529.1 7600.7 7649.7 7077.4 7118.4 7159.4 7171.1 7181.2 4559.4 4940.5 5089.9 5127.0 5169.2 5134.0 5202.4 5260.4 5269.3 5394.4 19:16:22 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | [#4] prototype.html Cycles:180 Average:4517.29 Median:5014.83 stddev:1411.76 (28.2%) stddev-sans-first:1379.75 19:16:22 INFO - PROCESS | 2200 | Values: 298.0 305.7 313.6 315.9 317.6 5420.8 5477.6 5483.0 5486.4 5496.3 4982.2 5153.6 5328.2 5340.3 5462.2 3348.9 3638.4 4174.9 4210.9 4213.7 4123.8 4172.4 4191.7 4198.3 4212.5 4050.0 4057.9 4164.5 4186.1 4198.3 4126.6 4151.3 4154.9 4175.7 4179.9 3599.6 3600.7 3609.8 3616.7 3628.5 4353.6 4419.4 5282.0 5293.9 5344.0 4523.7 4595.2 4638.6 4663.6 4664.6 4873.0 5140.7 5218.9 5638.2 5705.4 3437.5 3851.5 3852.7 3868.1 3875.1 5076.7 5960.5 5960.8 5972.5 5981.4 3179.9 3466.9 3820.7 3837.9 3895.6 3545.7 3934.8 3945.8 3965.6 3996.7 3827.9 4113.8 4496.1 4596.7 4597.7 4949.4 5483.9 5660.0 5717.0 5767.6 1180.7 1232.0 1244.5 1318.8 1356.0 769.5 854.8 871.6 874.5 878.8 4654.7 4903.2 4989.2 5098.7 5376.2 5308.0 5348.6 5626.5 5729.0 5809.7 4264.8 5036.3 5262.8 5265.4 5330.7 2208.4 2262.5 2430.5 2500.0 2596.8 4350.0 4389.8 4682.7 5021.2 5093.8 4172.9 4907.1 4953.8 4980.2 5027.2 4949.4 5727.1 6151.5 6159.7 6229.8 5285.3 5306.4 5918.6 5983.8 5999.3 5165.9 5578.6 5836.7 5901.3 5922.4 5128.8 5430.2 5822.3 5954.3 6173.7 3518.5 4069.7 4115.9 4117.5 4138.9 5008.4 5448.5 5588.3 5725.0 5888.0 4521.7 5503.6 5660.9 5735.7 5795.9 5255.3 5630.0 5720.4 5783.5 5798.4 4549.5 4906.0 5325.9 5640.7 5649.6 5712.4 5745.2 5749.6 5761.4 5789.4 5619.6 5625.6 5635.2 5711.5 5720.3 19:16:22 INFO - PROCESS | 2200 | 19:16:22 INFO - PROCESS | 2200 | [#5] yui.html Cycles:180 Average:26885.75 Median:23648.23 stddev:43704.70 (184.8%) stddev-sans-first:43783.18 19:16:22 INFO - PROCESS | 2200 | Values: 731.5 745.3 756.5 757.5 760.6 15139.5 16311.3 16336.2 16340.0 16346.5 14834.6 15052.3 15055.7 15058.0 15081.7 718.6 905.3 905.5 910.0 912.7 726.5 750.7 898.7 923.5 930.5 956.0 969.6 969.7 969.8 972.9 964.0 964.4 968.8 969.4 971.8 564.6 572.1 584.2 585.1 694.2 15393.1 15544.7 15547.7 15563.3 15571.9 14348.4 14563.6 14608.0 14730.9 15031.3 12085.3 12337.0 12442.8 12530.4 12578.4 4540.7 4604.7 4680.7 4785.0 4841.1 115011.4 124748.4 124935.0 125329.1 125659.0 11484.3 11612.2 11664.9 11774.8 11967.4 23589.1 23599.9 23634.1 23662.4 23671.9 7909.3 7911.6 7913.4 8083.3 8133.8 3809.8 4348.0 4430.9 4433.3 4592.7 3497.8 3580.9 3614.6 3615.3 3619.3 649.3 654.0 657.5 660.9 669.4 596.1 608.4 609.1 644.7 659.9 8748.0 8783.6 9016.1 9036.2 9110.3 550.5 573.3 578.6 619.7 636.1 4416.2 4443.7 4451.4 4501.8 4561.3 162031.0 164236.0 165278.0 165336.0 165767.0 128023.0 139762.0 143635.0 145666.3 147757.3 106104.0 121619.0 124146.4 124279.4 125356.4 8233.7 8684.2 8692.7 8802.9 8908.2 59878.0 62572.1 65168.7 65658.7 65867.3 97177.0 99058.5 101198.0 102659.5 105275.4 13341.3 13343.5 13531.5 13791.0 14244.4 15146.5 15403.5 15432.2 15724.5 16123.0 14150.8 14493.0 14555.3 14586.8 15046.4 13978.5 14163.0 14283.6 14342.4 14505.3 13825.9 14081.2 14374.7 14493.3 14597.2 11399.2 11550.7 11602.8 11630.5 11755.9 11347.1 11501.5 11584.7 11685.6 11818.4 19:16:22 INFO - PROCESS | 2200 | -------- Summary: end -------- 19:16:22 INFO - PROCESS | 2200 | 19:16:23 INFO - TEST-INFO | 2200: exit 0 19:16:23 INFO - TEST-OK | dromaeo_css | took 1116013ms 19:16:23 INFO - TEST-START | kraken 19:16:23 INFO - operating with platform_type : mac_ 19:16:23 INFO - Initialising browser for kraken test... 19:16:23 INFO - TEST-INFO | started process 2202 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/tmpU6fNj9/profile http://localhost:57602/getInfo.html) 19:16:25 INFO - PROCESS | 2202 | __metrics Screen width/height:1600/1200 19:16:25 INFO - PROCESS | 2202 | colorDepth:24 19:16:25 INFO - PROCESS | 2202 | Browser inner width/height: 1024/689 19:16:25 INFO - PROCESS | 2202 | __metrics 19:16:25 INFO - PROCESS | 2202 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 19:16:25 INFO - PROCESS | 2202 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:16:26 INFO - TEST-INFO | 2202: exit 0 19:16:26 INFO - Browser initialized. 19:16:26 INFO - Running cycle 1/1 for kraken test... 19:16:26 INFO - TEST-INFO | started process 2203 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/T/tmpU6fNj9/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:16:38 INFO - PROCESS | 2203 | RSS: Main: 244666368 19:16:38 INFO - PROCESS | 2203 | 19:16:41 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:57602/tests/kraken/driver.html?testName=audio-beat-detection) 19:16:42 INFO - PROCESS | 2203 | RSS: Main: 294379520 19:16:42 INFO - PROCESS | 2203 | 19:16:44 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:57602/tests/kraken/driver.html?testName=audio-dft) 19:16:45 INFO - PROCESS | 2203 | RSS: Main: 304570368 19:16:45 INFO - PROCESS | 2203 | 19:16:48 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:57602/tests/kraken/driver.html?testName=audio-fft) 19:16:49 INFO - PROCESS | 2203 | RSS: Main: 393138176 19:16:49 INFO - PROCESS | 2203 | 19:16:51 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:57602/tests/kraken/driver.html?testName=audio-oscillator) 19:16:52 INFO - PROCESS | 2203 | RSS: Main: 292741120 19:16:52 INFO - PROCESS | 2203 | 19:16:54 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:57602/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:16:54 INFO - PROCESS | 2203 | RSS: Main: 296620032 19:16:54 INFO - PROCESS | 2203 | 19:16:57 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:57602/tests/kraken/driver.html?testName=imaging-darkroom) 19:16:58 INFO - PROCESS | 2203 | RSS: Main: 332607488 19:16:58 INFO - PROCESS | 2203 | 19:17:01 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:57602/tests/kraken/driver.html?testName=imaging-desaturate) 19:17:01 INFO - PROCESS | 2203 | RSS: Main: 335306752 19:17:01 INFO - PROCESS | 2203 | 19:17:04 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:57602/tests/kraken/driver.html?testName=json-parse-financial) 19:17:05 INFO - PROCESS | 2203 | RSS: Main: 333193216 19:17:05 INFO - PROCESS | 2203 | 19:17:06 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:57602/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:17:07 INFO - PROCESS | 2203 | RSS: Main: 311853056 19:17:07 INFO - PROCESS | 2203 | 19:17:09 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:57602/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:17:09 INFO - PROCESS | 2203 | RSS: Main: 318472192 19:17:09 INFO - PROCESS | 2203 | 19:17:11 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:57602/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:17:12 INFO - PROCESS | 2203 | RSS: Main: 316964864 19:17:12 INFO - PROCESS | 2203 | 19:17:15 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:57602/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:17:16 INFO - PROCESS | 2203 | RSS: Main: 325582848 19:17:16 INFO - PROCESS | 2203 | 19:17:19 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:57602/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:17:19 INFO - PROCESS | 2203 | RSS: Main: 326746112 19:17:19 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | Cycle 1(1): loaded http://localhost:57602/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:57602/tests/kraken/driver.html?testName=ai-astar) 19:17:21 INFO - PROCESS | 2203 | RSS: Main: 370565120 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | __start_tp_report 19:17:21 INFO - PROCESS | 2203 | _x_x_mozilla_page_load 19:17:21 INFO - PROCESS | 2203 | _x_x_mozilla_page_load_details 19:17:21 INFO - PROCESS | 2203 | |i|pagename|runs| 19:17:21 INFO - PROCESS | 2203 | |0;ai-astar;101;112;113;114;114;113;113;114;113;113 19:17:21 INFO - PROCESS | 2203 | |1;audio-beat-detection;141;108;109;192;133;131;132;114;151;130 19:17:21 INFO - PROCESS | 2203 | |2;audio-dft;187;182;182;183;184;184;179;183;185;182 19:17:21 INFO - PROCESS | 2203 | |3;audio-fft;80;75;58;107;56;56;58;61;128;56 19:17:21 INFO - PROCESS | 2203 | |4;audio-oscillator;84;85;94;71;69;67;96;68;66;100 19:17:21 INFO - PROCESS | 2203 | |5;imaging-gaussian-blur;87;84;88;85;87;84;89;85;87;84 19:17:21 INFO - PROCESS | 2203 | |6;imaging-darkroom;92;93;93;93;94;93;93;93;93;93 19:17:21 INFO - PROCESS | 2203 | |7;imaging-desaturate;84;84;90;83;84;86;83;86;84;86 19:17:21 INFO - PROCESS | 2203 | |8;json-parse-financial;56;54;54;53;55;55;54;54;55;54 19:17:21 INFO - PROCESS | 2203 | |9;json-stringify-tinderbox;64;73;80;75;72;71;73;70;70;72 19:17:21 INFO - PROCESS | 2203 | |10;stanford-crypto-aes;93;93;96;82;82;83;79;81;86;82 19:17:21 INFO - PROCESS | 2203 | |11;stanford-crypto-ccm;147;154;152;137;136;135;135;133;173;143 19:17:21 INFO - PROCESS | 2203 | |12;stanford-crypto-pbkdf2;164;166;162;163;165;221;201;164;164;161 19:17:21 INFO - PROCESS | 2203 | |13;stanford-crypto-sha256-iterative;66;66;68;66;66;67;65;67;66;66 19:17:21 INFO - PROCESS | 2203 | __end_tp_report 19:17:21 INFO - PROCESS | 2203 | __start_cc_report 19:17:21 INFO - PROCESS | 2203 | _x_x_mozilla_cycle_collect,2039 19:17:21 INFO - PROCESS | 2203 | __end_cc_report 19:17:21 INFO - PROCESS | 2203 | __startTimestamp1467771441653__endTimestamp 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | ------- Summary: start ------- 19:17:21 INFO - PROCESS | 2203 | Number of tests: 14 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#0] ai-astar Cycles:10 Average:112.00 Median:113.00 stddev:3.92 (3.5%) stddev-sans-first:0.67 19:17:21 INFO - PROCESS | 2203 | Values: 101.0 112.0 113.0 114.0 114.0 113.0 113.0 114.0 113.0 113.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#1] audio-beat-detection Cycles:10 Average:134.10 Median:132.50 stddev:24.57 (18.5%) stddev-sans-first:25.93 19:17:21 INFO - PROCESS | 2203 | Values: 141.0 108.0 109.0 192.0 133.0 131.0 132.0 114.0 151.0 130.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#2] audio-dft Cycles:10 Average:183.10 Median:183.50 stddev:2.13 (1.2%) stddev-sans-first:1.73 19:17:21 INFO - PROCESS | 2203 | Values: 187.0 182.0 182.0 183.0 184.0 184.0 179.0 183.0 185.0 182.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#3] audio-fft Cycles:10 Average:73.50 Median:58.00 stddev:25.15 (43.4%) stddev-sans-first:26.56 19:17:21 INFO - PROCESS | 2203 | Values: 80.0 75.0 58.0 107.0 56.0 56.0 58.0 61.0 128.0 56.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#4] audio-oscillator Cycles:10 Average:80.00 Median:77.50 stddev:13.35 (17.2%) stddev-sans-first:14.08 19:17:21 INFO - PROCESS | 2203 | Values: 84.0 85.0 94.0 71.0 69.0 67.0 96.0 68.0 66.0 100.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#5] imaging-gaussian-blur Cycles:10 Average:86.00 Median:87.00 stddev:1.83 (2.1%) stddev-sans-first:1.90 19:17:21 INFO - PROCESS | 2203 | Values: 87.0 84.0 88.0 85.0 87.0 84.0 89.0 85.0 87.0 84.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#6] imaging-darkroom Cycles:10 Average:93.00 Median:93.00 stddev:0.47 (0.5%) stddev-sans-first:0.33 19:17:21 INFO - PROCESS | 2203 | Values: 92.0 93.0 93.0 93.0 94.0 93.0 93.0 93.0 93.0 93.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#7] imaging-desaturate Cycles:10 Average:85.00 Median:85.00 stddev:2.11 (2.5%) stddev-sans-first:2.20 19:17:21 INFO - PROCESS | 2203 | Values: 84.0 84.0 90.0 83.0 84.0 86.0 83.0 86.0 84.0 86.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#8] json-parse-financial Cycles:10 Average:54.40 Median:54.50 stddev:0.84 (1.5%) stddev-sans-first:0.67 19:17:21 INFO - PROCESS | 2203 | Values: 56.0 54.0 54.0 53.0 55.0 55.0 54.0 54.0 55.0 54.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#9] json-stringify-tinderbox Cycles:10 Average:72.00 Median:72.50 stddev:4.06 (5.6%) stddev-sans-first:3.10 19:17:21 INFO - PROCESS | 2203 | Values: 64.0 73.0 80.0 75.0 72.0 71.0 73.0 70.0 70.0 72.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#10] stanford-crypto-aes Cycles:10 Average:85.70 Median:84.50 stddev:6.04 (7.1%) stddev-sans-first:5.80 19:17:21 INFO - PROCESS | 2203 | Values: 93.0 93.0 96.0 82.0 82.0 83.0 79.0 81.0 86.0 82.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#11] stanford-crypto-ccm Cycles:10 Average:144.50 Median:145.00 stddev:12.51 (8.6%) stddev-sans-first:13.24 19:17:21 INFO - PROCESS | 2203 | Values: 147.0 154.0 152.0 137.0 136.0 135.0 135.0 133.0 173.0 143.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:173.10 Median:164.50 stddev:20.57 (12.5%) stddev-sans-first:21.55 19:17:21 INFO - PROCESS | 2203 | Values: 164.0 166.0 162.0 163.0 165.0 221.0 201.0 164.0 164.0 161.0 19:17:21 INFO - PROCESS | 2203 | 19:17:21 INFO - PROCESS | 2203 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.30 Median:66.00 stddev:0.82 (1.2%) stddev-sans-first:0.87 19:17:21 INFO - PROCESS | 2203 | Values: 66.0 66.0 68.0 66.0 66.0 67.0 65.0 67.0 66.0 66.0 19:17:21 INFO - PROCESS | 2203 | -------- Summary: end -------- 19:17:21 INFO - PROCESS | 2203 | 19:17:22 INFO - TEST-INFO | 2203: exit 0 19:17:22 INFO - TEST-OK | kraken | took 59022ms 19:17:22 INFO - SUITE-END | took 1175s 19:17:22 INFO - Completed test suite (00:19:35) 19:17:22 INFO - javascript benchmark 19:17:22 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2753.2566207124078, 3369.258763072123, 3398.88103916363, 3402.1154499830045, 3423.811690357031, 5636.7181640918, 5717.742701578429, 5732.455416735414, 5761.078227483604, 5795.0, 4951.752412379385, 5712.371639119693, 5736.827895163141, 5893.0, 5912.940870591293, 5190.117679994391, 5199.1161502544655, 5249.737513124348, 5270.7628156733035, 5368.3021207243, 5340.732963351837, 5347.411784703699, 5371.919421208666, 5374.140137577989, 5387.946120538803, 5172.379314482268, 5225.346831646044, 5250.894982100336, 5285.86785330366, 5307.495787900143, 5214.191800270964, 5282.022825777243, 5286.735663216824, 5337.2527846101575, 5375.489328513785, 5191.610629202825, 5199.506046925536, 5214.869628259324, 5299.099153143975, 5311.893762124736, 5770.9422905770825, 5785.045467497858, 5797.333306669745, 5823.301203855522, 5895.115732640095, 6133.67132064549, 6204.317525072239, 6258.0, 6268.717907694165, 6293.685315734195, 6282.497400208018, 6314.305426403092, 6316.74733010679, 6347.143135676717, 6357.17356743625, 5834.753405682276, 5850.473457388855, 5854.853628659318, 5892.998190307658, 5901.2918449785875, 5330.92003619946, 6194.287656919422, 6262.937370626236, 6273.811785646438, 6312.463440607508, 6218.284897236786, 6249.1563638908165, 6269.592476489013, 6270.090836828635, 6278.215223097113, 6307.590006649553, 6310.5267104967315, 6310.684465776692, 6317.5893566918, 6336.461400780985, 6119.41115851624, 6184.072389141665, 6260.780872669435, 6274.403931626488, 6331.588446750947, 6228.906566401508, 6301.243850737941, 6303.243610766737, 6311.211098612674, 6327.082573026885, 4853.053654537332, 4971.1549036663855, 4974.427940786783, 4982.177940639826, 4998.475160108209, 3857.9228415431535, 4414.0, 4422.778861056934, 4431.7340959542535, 4462.196804575207, 5826.737796799154, 5828.446297601721, 5840.328362238312, 5859.677717725566, 5903.616264942765, 6180.721867515973, 6259.217597800275, 6259.4679452246155, 6259.593126446766, 6277.748890044347, 5717.42825717425, 5786.797462088891, 5794.072948328248, 5832.212651292106, 5887.735051922674, 5462.2079798429, 5482.314710661168, 5483.013057649581, 5489.039418101816, 5492.395836457987, 6243.843903902439, 6432.260290066609, 6448.32292609288, 6458.063580780855, 6459.257185423642, 6245.937540624717, 6270.498360131087, 6312.084747711648, 6313.747450101944, 6314.810555683337, 6399.904001440075, 6419.903701444576, 6423.100765892686, 6424.582402144033, 6429.7749578764515, 6135.141080248858, 6195.81412557624, 6257.5932564383165, 6270.310265870842, 6277.874442511215, 5545.556355491471, 6046.788362407295, 6223.782167624111, 6257.186565746606, 6276.435120839146, 5580.77676892936, 6155.507559395327, 6182.0, 6186.257649082139, 6204.875902481835, 4987.351644286365, 6110.602810817282, 6166.445019948226, 6181.165542651865, 6182.721777519932, 5969.8806023878415, 6023.789167379121, 6067.7463934540465, 6068.672341355384, 6106.175666284995, 6188.721507532082, 6197.442230199304, 6219.284782250099, 6224.968875155595, 6240.875182496416, 5809.215755873072, 5882.764689412375, 5942.910856337072, 6075.635461872302, 6088.086786981989], "value": 5735.355218164265, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [512.3083836820291, 526.2816255810819, 536.2010604199744, 539.2235181338872, 562.6427218716115, 25490.0, 31197.844010779943, 32771.0, 41466.378004329956, 43554.346684799755, 45345.41291054814, 45725.77137114318, 45935.16259349622, 45941.0, 45976.0, 9173.220276276492, 9312.882454105516, 9702.029797020294, 9879.407235565888, 9912.008799120102, 8763.78090547735, 8958.820823583525, 9703.61185552577, 11852.466639001223, 12053.156279060426, 12047.216930899463, 12059.3970301485, 12126.636200913943, 12149.210301330386, 12150.878491215062, 8808.427452215585, 11993.94003029988, 12052.57815976441, 12096.455659495256, 12101.0, 8752.8687069694, 8966.148215919542, 8967.01362850086, 11653.59212427561, 11940.104492163036, 42909.57090429087, 43127.56872431267, 43204.351934721, 43232.78383608093, 43291.56708432907, 3522.119470132467, 3604.6034936157002, 3727.5713292971386, 3740.532433445819, 3827.9043023924346, 32106.0, 33588.6641133588, 33740.987770366926, 34256.82871585651, 34410.82794586011, 3266.9019929402157, 3281.1305004173914, 3317.303366293081, 3393.474011528217, 3402.9829850850833, 549822.0, 550533.0, 555299.0, 555786.0, 555799.0, 65848.67075664687, 66637.00044499336, 66765.0, 66766.33233667698, 66924.66537667377, 71004.93492597615, 71025.28974710187, 71132.0, 71135.6443217791, 71235.6438217816, 17365.7395139073, 17674.0, 17680.734788978174, 17705.7344139838, 17708.468745937644, 12106.455209515418, 12375.443105060294, 13300.0, 13431.261280629658, 13494.93252533731, 17158.571035724206, 18144.253485894435, 20073.397798066082, 20192.798072019385, 20299.797002030085, 8230.465019773696, 8317.542535160503, 8329.750107496784, 8350.369633565408, 8359.247667709935, 950.7005293332578, 977.750673578233, 989.3816364772017, 1040.6149724601946, 1098.9670309890716, 26747.93008279647, 29619.407611848073, 31776.682233177373, 31899.043028709177, 32023.0, 1090.574675876409, 1117.8211486162174, 1126.1272513801705, 1193.6836738264367, 1217.7807994561065, 16308.918455407647, 16365.836341636432, 16373.67252654964, 16491.752623710654, 16874.915625421796, 700643.0, 709097.4545127344, 712850.0, 712861.0, 714193.0, 63620.363796361446, 64073.0, 64217.0, 64227.35772642307, 64400.0, 1300.1808860417875, 1417.433026789272, 1432.6704857882746, 1449.0653528473865, 1457.3514785920377, 31728.365432690756, 32129.393530323858, 32389.51415728813, 32403.35193296168, 32590.185245369055, 53677.46322536881, 53975.92048159093, 54678.0, 54746.0, 54768.45231547634, 465373.7313134262, 482962.0, 562460.0, 563786.0, 565311.0, 24583.877080614482, 27335.0, 27791.0, 27791.44417111606, 28957.42085158243, 49827.75086124546, 50022.749886250334, 50616.74691626518, 51589.0, 51771.74114129405, 41682.58317416787, 41866.0, 41905.37141942812, 42946.57053429426, 43188.0, 40319.0, 41097.97255068647, 42594.22602352762, 42813.57186428096, 43016.56983430251, 40416.79791601023, 41180.58819411768, 41541.79229103835, 41593.54422595195, 41707.16585668331, 36433.9069827895, 36509.08727281733, 37036.81481592575, 37515.81242093772, 37597.0, 24303.05575553916, 25761.742382575936, 26884.0, 26906.461870762083, 27210.45579088447], "value": 21316.611204942554, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [329.89443378119006, 367.65991457901436, 392.7093950476647, 400.0678419283069, 418.76339867974593, 15951.282192301345, 16190.109543975077, 20371.99999999998, 21240.044198011088, 21844.563108737857, 21881.890590547064, 22083.227087051957, 22595.322140335775, 22839.54320913581, 22883.084676612914, 5783.913241301373, 5994.340622531518, 6029.849253768669, 6036.637801731888, 6044.697765111749, 5536.944630553703, 5853.0, 5862.794802181925, 5866.823995280127, 5878.118282257653, 5736.541076713874, 5791.10237913122, 5796.333421656522, 5812.186293918855, 5814.796482123126, 5692.943070569283, 5839.065749480063, 5858.648481091148, 5866.530677545786, 5870.559708021916, 4906.165951788169, 5013.598912087061, 5019.799208031674, 5107.591392688576, 5150.948490515084, 27205.0, 27218.727812721816, 27468.313292167655, 27469.626518673987, 27639.447211055867, 2237.6830594580074, 2366.786989170983, 2473.323019556506, 2503.198976327576, 2521.823472356936, 15745.448909288234, 16043.083900226706, 16393.0, 16533.58666033347, 16599.751003734953, 1831.6519861226457, 1886.8490520758307, 1894.2707057782852, 1899.1833511590012, 1966.7541557305337, 122119.0, 124032.0, 127045.0, 127893.0, 128895.0, 8031.477953932976, 10494.212934029978, 10705.411202383944, 10905.509252083675, 11269.380184089954, 12821.679458013437, 13569.118007329493, 13585.728285434236, 13926.0, 13947.0, 7382.704691812267, 8570.528620925785, 8795.472271663593, 8842.115788421106, 8961.059088795713, 8928.15182557656, 8933.0, 8951.194392504705, 9043.773905652411, 9051.81896362069, 5755.0, 6668.533202675766, 6731.730730770812, 6742.0, 6784.219814721271, 1809.746635471035, 1831.9450416487527, 1848.0944337274639, 1848.159087615132, 1849.6208277303122, 916.2440986186423, 940.3135710931059, 978.9461579613189, 1015.4364327798143, 1045.1116550931647, 22808.771912280667, 23147.842607869537, 23225.419364515685, 23325.300240992798, 23375.064997400255, 948.7106432538004, 969.5007071358256, 991.2417000994245, 1004.8944860789658, 1048.7849990751877, 10778.353298802096, 11414.600488982845, 11622.6513204604, 12286.508539658313, 12396.938015309866, 551270.0, 576920.0, 597844.0215597876, 607311.0, 633857.0, 110970.0, 111725.0, 113040.43479782548, 122901.0, 127277.0, 1048.6591857646295, 1049.2969710294121, 1050.7635781949152, 1052.4369462337613, 1074.006543946846, 20429.978501075184, 20703.86984033689, 20776.48058798542, 20934.16263349449, 21000.894995524926, 55085.173722393396, 56772.86454270974, 56835.0, 57230.0, 57824.0, 80510.00915349892, 80544.0, 80776.59611701904, 80813.3837323262, 81230.59384703038, 5529.944700553104, 5810.448007439287, 8094.10964793884, 8125.530957973209, 8490.745277641681, 13460.326983650973, 13754.466057959427, 13792.241426721226, 13859.376328065462, 13895.513657021957, 11691.240069395462, 11738.0, 11902.880971190178, 11913.761724765283, 11930.880691193324, 11694.064474842162, 11752.353620550952, 11753.177277590486, 11763.529458821551, 11945.04439644809, 11830.349330786888, 11836.70408239801, 11924.0, 11975.580854670045, 12055.397230138633, 7603.467757256939, 7659.6212681717825, 8085.555294458626, 8325.583720813815, 8330.458520196167, 11807.409629518317, 11875.406229688653, 11997.700057498632, 12035.638930832089, 12061.035117190428], "value": 9980.223454959136, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1398.713263780925, 1548.3974086820144, 1582.2247098921528, 1772.175938188742, 1904.2002359009214, 7871.370290376771, 8689.956550217248, 8911.064338244472, 8945.642174313036, 9074.909250907489, 8629.05080441151, 8889.0, 8898.421602595827, 8905.975812781531, 8918.108189181095, 2007.9397618071407, 2397.19693902542, 2400.4478969836946, 2400.7719266669724, 2402.0992127952018, 2341.6838726771925, 2385.1771138957033, 2386.069432921162, 2388.199953015742, 2393.7127544694663, 2337.532493501298, 2349.5888219561593, 2363.243761996162, 2373.5134297468976, 2376.786089251967, 2313.7223533175957, 2345.7419683834764, 2346.272655476808, 2351.0830775997374, 2358.433975845793, 2312.988435057831, 2322.7909488146147, 2323.1404380379367, 2325.058351367682, 2329.8485598436046, 8830.779230519223, 8915.019347871728, 8938.776530586787, 8981.955090224506, 9067.863982040275, 5336.332958380202, 5480.424555421663, 5485.4788795064405, 5489.6980666063355, 5492.80775172871, 3352.8155951422664, 3607.8196090195647, 3668.743187976843, 3708.87018954338, 3711.962880371189, 1100.4167791070745, 1105.4307031878589, 1107.6123356825128, 1125.5047778977223, 1126.4480404601768, 11680.0, 11760.411979401082, 11761.470733817, 11767.646970590897, 11836.349000804952, 4374.4531933508315, 4394.868153955386, 4589.885252868705, 4600.838970636011, 4601.4248218972625, 9149.130832570896, 9160.267178625694, 9162.0, 9167.541622918827, 9170.633174673072, 5226.973865130726, 5241.73791310433, 5242.7640756166065, 5248.711320877312, 5250.343707036621, 4395.648348132142, 4545.454545454567, 4792.2092854678585, 4930.383702037246, 4949.678270912379, 3784.0, 3794.5256842894637, 3872.5546562145714, 3903.1608204236227, 3909.2181563687377, 1013.5084484025242, 1173.3194747046864, 1181.1200655511527, 1197.7604479104214, 1202.3627477436971, 672.5897202706345, 849.3247867944998, 904.8326059678981, 958.4297343080856, 979.7893452907516, 5235.345581802275, 5814.0, 5982.4017598239825, 6131.570790044654, 6256.061590761422, 486.13468026912153, 487.8365747474565, 498.1804930888668, 502.84663177730414, 640.5420124610926, 3904.90237744053, 4098.344264917599, 4127.731697439657, 4134.896627584334, 4165.729227600196, 10673.786524269472, 10875.728106797234, 11166.832497512543, 11169.44152792357, 11182.273152245078, 11104.666859994213, 11112.111031117653, 11117.55529778816, 11129.332240065622, 11134.665960021212, 7942.245486678757, 8193.303569196685, 8294.792630184173, 8340.457870238415, 8364.121767214476, 6045.455908968214, 6068.6358818471035, 6154.723037463235, 6237.656928868956, 6260.780872669617, 9958.502074896081, 10215.795684086424, 10468.68593942183, 10471.94764026175, 10520.842187367349, 10132.74668133273, 10436.63471778484, 10494.68515944523, 10500.789984200426, 10556.313839600401, 7633.618319084135, 7722.266384693445, 7795.532268063935, 7799.922000780147, 7808.102068261996, 8201.548914809742, 8449.0, 8480.830383392175, 8481.40630155883, 8484.448510846774, 5674.914876276942, 6786.524943254122, 7513.060867391576, 7581.324224490484, 7836.764897053097, 7456.627168641655, 7521.586312752632, 7529.13414957265, 7600.733974311093, 7649.694012239448, 7077.398421134261, 7118.359347658736, 7159.391451726661, 7171.103612048494, 7181.245969173162, 4559.361689363558, 4940.481249468754, 5089.949100508948, 5127.0, 5169.224616307584, 5134.0, 5202.375714914235, 5260.368755749335, 5269.314989051399, 5394.379646340721], "value": 4539.919985713221, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [297.9999999999999, 305.70804881338324, 313.55944897419135, 315.87680804486257, 317.6458249052306, 5420.756065977031, 5477.643953143043, 5482.972585137074, 5486.396496385394, 5496.340439147308, 4982.1957419606115, 5153.6392452528335, 5328.200769884519, 5340.279062326585, 5462.20797984292, 3348.8827891023757, 3638.3621874141168, 4174.891679701762, 4210.894727631803, 4213.747175169499, 4123.793810309473, 4172.395002724618, 4191.727537710054, 4198.3282674772045, 4212.452381190456, 4049.995252350091, 4057.9391309130388, 4164.541900390955, 4186.120914607921, 4198.3282674772045, 4126.628603425676, 4151.252774500589, 4154.854580089713, 4175.749455032693, 4179.895502612429, 3599.6220396858216, 3600.747947643666, 3609.8014609196484, 3616.710663146942, 3628.455731640249, 4353.62994145498, 4419.447569053868, 5282.0, 5293.947060529384, 5344.0, 4523.665518671966, 4595.172868883599, 4638.582527572501, 4663.580277774982, 4664.580187783082, 4872.975635121802, 5140.7172605506685, 5218.947810521884, 5638.210650508932, 5705.432555350068, 3437.5187473753695, 3851.5185601799776, 3852.667442662077, 3868.052327179859, 3875.0893540018074, 5076.670016448919, 5960.493358064569, 5960.791372301992, 5972.50687328168, 5981.401859814027, 3179.9364012719616, 3466.878659246914, 3820.675242604354, 3837.8529605723597, 3895.5909629488497, 3545.7163426925786, 3934.8229329680235, 3945.835978386383, 3965.6232657897453, 3996.680265578747, 3827.8660246891227, 4113.773742444194, 4496.066691322697, 4596.701214421052, 4597.678162528591, 4949.356583644103, 5483.890322193533, 5660.037793575102, 5717.0, 5767.567432442584, 1180.6812160716559, 1231.969200769988, 1244.4710997825887, 1318.775808112623, 1355.959321220365, 769.4806005945964, 854.8461276970205, 871.6034204436966, 874.4709450782185, 878.7759121423996, 4654.720716757005, 4903.239997800347, 4989.226669866177, 5098.694078355311, 5376.1935709643085, 5307.973460132752, 5348.572114230852, 5626.549876009909, 5728.971355143198, 5809.680467574324, 4264.829406823692, 5036.32009678696, 5262.7631756571045, 5265.368155821326, 5330.733463326818, 2208.403730992623, 2262.547490501873, 2430.4774473488283, 2499.962500562493, 2596.792256619466, 4350.042480883615, 4389.84635537761, 4682.74244916526, 5021.213226659239, 5093.752030752489, 4172.9359013451985, 4907.111466240454, 4953.847998082027, 4980.203167493184, 5027.2207807789855, 4949.406071271471, 5727.05503591911, 6151.508639001122, 6159.72281247336, 6229.7508099676415, 5285.312909321764, 5306.434601792404, 5918.585699001201, 5983.790567330297, 5999.340072591924, 5165.896682066413, 5578.609497335147, 5836.678982655825, 5901.3213480450295, 5922.407759224043, 5128.8461346159675, 5430.212619170277, 5822.3304320003745, 5954.320555750017, 6173.69131543412, 3518.472229165646, 4069.659945531272, 4115.9176816464105, 4117.508907111154, 4138.937915931203, 5008.449070602303, 5448.509634132947, 5588.30146231721, 5724.971375143097, 5888.0, 4521.683482156218, 5503.559715222853, 5660.924424359358, 5735.7418916148035, 5795.913880714171, 5255.290535777774, 5630.016091471527, 5720.3707592164, 5783.479486846204, 5798.449147330997, 4549.45406551216, 4905.950940490549, 5325.854941187508, 5640.661560306395, 5649.5762817789655, 5712.429406767054, 5745.213571417776, 5749.597528172988, 5761.395053519488, 5789.421057894346, 5619.550435965195, 5625.578081643811, 5635.239242702182, 5711.485966263056, 5720.256366672306], "value": 4062.4650336601762, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [731.4989232375823, 745.3254804402018, 756.5007095317088, 757.5114051436823, 760.5511500591375, 15139.470118545853, 16311.265993030313, 16336.18319084047, 16340.019598824065, 16346.509604711862, 14834.55496335109, 15052.322645480952, 15055.698886022274, 15058.021228620159, 15081.698366032673, 718.6227230703884, 905.3164860530323, 905.4567259644226, 909.9772505687378, 912.6851236323491, 726.5422783646295, 750.6997201119568, 898.6899519665704, 923.5151545438631, 930.4975313330827, 955.9904400956005, 969.5733877094056, 969.6848524229619, 969.7769513012012, 972.9027097290285, 963.9566219520138, 964.4165280005636, 968.8110818390417, 969.3989726369625, 971.7522031881825, 564.5540023381565, 572.084664536742, 584.211314725122, 585.0960266388397, 694.1531331775226, 15393.076415415111, 15544.689106217926, 15547.689046219126, 15563.299651515596, 15571.922140389226, 14348.354324055443, 14563.635909102251, 14608.0, 14730.852691473163, 15031.323590438456, 12085.335306558136, 12337.0, 12442.81335779964, 12530.373481325989, 12578.433970471351, 4540.682152249344, 4604.723716577016, 4680.672352935296, 4785.0, 4841.080194762983, 115011.42494287476, 124748.37625811904, 124935.0, 125329.12006319912, 125659.0, 11484.310941343547, 11612.245204061708, 11664.88335116638, 11774.764504709858, 11967.40162991847, 23589.05643774264, 23599.88200058989, 23634.05463781464, 23662.4084397888, 23671.93476293571, 7909.288164065261, 7911.643976021093, 7913.366930645535, 8083.312918401884, 8133.75598732039, 3809.799913027443, 4348.043430445297, 4430.933535996963, 4433.334999750064, 4592.7014744041535, 3497.755157138976, 3580.946285805715, 3614.6204648512053, 3615.2769446110883, 3619.3123306571665, 649.2792999770252, 654.0255020020136, 657.5101549345673, 660.8744338575656, 669.3707914560298, 596.0760820727854, 608.4068033667139, 609.0894113300644, 644.7087617711609, 659.9340065993363, 8747.956260218658, 8783.604737786814, 9016.143466370684, 9036.186743193144, 9110.27117830572, 550.4577990679178, 573.3005733005726, 578.6383510306059, 619.7348690536008, 636.147562266565, 4416.205083085076, 4443.711158774734, 4451.421315228999, 4501.774911254424, 4561.270196768501, 162031.0, 164236.0, 165278.0, 165336.0, 165767.0, 128023.0, 139762.0, 143635.0, 145666.2716686431, 147757.26121369324, 106104.0, 121619.0, 124146.3792681067, 124279.37860310821, 125356.37321813333, 8233.723772815223, 8684.175003374668, 8692.695755648521, 8802.899637545306, 8908.198262156437, 59878.0, 62572.06141907784, 65168.67415662891, 65658.67170664307, 65867.34132658612, 97177.0, 99058.50470747601, 101198.0, 102659.486702566, 105275.42086868857, 13341.266230357423, 13343.466261349826, 13531.526396576073, 13791.0, 14244.430222790972, 15146.545603631908, 15403.537893863202, 15432.22838858075, 15724.528264152093, 16123.032618042955, 14150.78773818414, 14493.0, 14555.345009474811, 14586.781198281822, 15046.398144074552, 13978.510752123628, 14162.99025068945, 14283.64290892736, 14342.354594043085, 14505.347259373142, 13825.930870345584, 14081.155130692192, 14374.712505749618, 14493.275336232935, 14597.197154156624, 11399.20205585601, 11550.653480395602, 11602.825957610474, 11630.476628551905, 11755.941220293844, 11347.092232621206, 11501.48243329069, 11584.652460426201, 11685.591004314809, 11818.40907954616], "value": 8114.617848474272, "unit": "score"}], "name": "dromaeo_css", "value": 7532.325269770123, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 112.0, 113.0, 114.0, 114.0, 113.0, 113.0, 114.0, 113.0, 113.0], "value": 112.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 108.0, 109.0, 192.0, 133.0, 131.0, 132.0, 114.0, 151.0, 130.0], "value": 134.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [187.0, 182.0, 182.0, 183.0, 184.0, 184.0, 179.0, 183.0, 185.0, 182.0], "value": 183.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 75.0, 58.0, 107.0, 56.0, 56.0, 58.0, 61.0, 128.0, 56.0], "value": 73.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 94.0, 71.0, 69.0, 67.0, 96.0, 68.0, 66.0, 100.0], "value": 80.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 84.0, 88.0, 85.0, 87.0, 84.0, 89.0, 85.0, 87.0, 84.0], "value": 86.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 93.0, 93.0, 93.0, 94.0, 93.0, 93.0, 93.0, 93.0, 93.0], "value": 93.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 90.0, 83.0, 84.0, 86.0, 83.0, 86.0, 84.0, 86.0], "value": 85.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 54.0, 54.0, 53.0, 55.0, 55.0, 54.0, 54.0, 55.0, 54.0], "value": 54.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 73.0, 80.0, 75.0, 72.0, 71.0, 73.0, 70.0, 70.0, 72.0], "value": 72.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 93.0, 96.0, 82.0, 82.0, 83.0, 79.0, 81.0, 86.0, 82.0], "value": 85.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 154.0, 152.0, 137.0, 136.0, 135.0, 135.0, 133.0, 173.0, 143.0], "value": 144.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 166.0, 162.0, 163.0, 165.0, 221.0, 201.0, 164.0, 164.0, 161.0], "value": 173.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 68.0, 66.0, 66.0, 67.0, 65.0, 67.0, 66.0, 66.0], "value": 66.3, "unit": "score"}], "name": "kraken", "value": 1442.6999999999998, "alertThreshold": 2.0}]} 19:17:22 INFO - Return code: 0 19:17:22 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 19:17:22 INFO - # TBPL SUCCESS # 19:17:22 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 19:17:22 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 19:17:22 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 19:17:22 INFO - 2016-07-05 19:17:22.971 screenresolution[2207:29975] starting screenresolution argv=screenresolution get 19:17:22 INFO - 2016-07-05 19:17:22.974 screenresolution[2207:29975] Display 0: 1600x1200x32@60 19:17:22 INFO - 2016-07-05 19:17:22.980 screenresolution[2208:29978] starting screenresolution argv=screenresolution list 19:17:22 INFO - Available Modes on Display 0 19:17:22 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 19:17:22 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 19:17:22 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 19:17:22 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 19:17:23 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 19:17:23 INFO - Intel Iris: 19:17:23 INFO - Chipset Model: Intel Iris 19:17:23 INFO - Type: GPU 19:17:23 INFO - Bus: Built-In 19:17:23 INFO - VRAM (Dynamic, Max): 1536 MB 19:17:23 INFO - Vendor: Intel (0x8086) 19:17:23 INFO - Device ID: 0x0a2e 19:17:23 INFO - Revision ID: 0x0009 19:17:23 INFO - Displays: 19:17:23 INFO - Display: 19:17:23 INFO - Resolution: 1600 x 1200 @ 60 Hz 19:17:23 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 19:17:23 INFO - Display Serial Number: 1600x1200 60 19:17:23 INFO - Main Display: Yes 19:17:23 INFO - Mirror: Off 19:17:23 INFO - Online: Yes 19:17:23 INFO - Rotation: Supported 19:17:23 INFO - Return code: 0 19:17:23 INFO - Running post-action listener: _resource_record_post_action 19:17:23 INFO - ##### 19:17:23 INFO - ##### Finished run-tests step (success) 19:17:23 INFO - ##### 19:17:23 INFO - Running post-run listener: _resource_record_post_run 19:17:23 INFO - Total resource usage - Wall time: 1210s; CPU: 53.0%; Read bytes: 385024; Write bytes: 703604736; Read time: 4; Write time: 1824 19:17:23 INFO - TinderboxPrint: CPU usage
53.4% 19:17:23 INFO - TinderboxPrint: I/O read bytes / time
385,024 / 4 19:17:23 INFO - TinderboxPrint: I/O write bytes / time
703,604,736 / 1,824 19:17:23 INFO - TinderboxPrint: CPU idle
2,255.1 (46.6%) 19:17:23 INFO - TinderboxPrint: CPU system
964.1 (19.9%) 19:17:23 INFO - TinderboxPrint: CPU user
1,622.4 (33.5%) 19:17:23 INFO - TinderboxPrint: Swap in / out
407,019,520 / 0 19:17:23 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 402606592; Write bytes: 397273088; Read time: 29616; Write time: 745 19:17:23 INFO - run-tests - Wall time: 1176s; CPU: 53.0%; Read bytes: 348160; Write bytes: 292421632; Read time: 3; Write time: 1041 19:17:23 INFO - Running post-run listener: _upload_blobber_files 19:17:23 INFO - Blob upload gear active. 19:17:23 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 19:17:23 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 19:17:23 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', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 19:17:23 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 Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 19:17:24 INFO - (blobuploader) - INFO - Open directory for files ... 19:17:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 19:17:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:17:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:17:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 19:17:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:17:25 INFO - (blobuploader) - INFO - Done attempting. 19:17:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 19:17:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:17:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:17:26 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 19:17:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:17:26 INFO - (blobuploader) - INFO - Done attempting. 19:17:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 19:17:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:17:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:17:28 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 19:17:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:17:28 INFO - (blobuploader) - INFO - Done attempting. 19:17:28 INFO - (blobuploader) - INFO - Iteration through files over. 19:17:28 INFO - Return code: 0 19:17:28 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 19:17:28 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 19:17:28 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/55471e0f1905cff977af3ea3c986fe765207aa39c7014f1b9ac220cd950e60a89df6a50e72d0a63c1dcf623b3b808d125564b16ab9e5f143584ab1c331e7dfec", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/4be2a1e89a5ccc742cc8afc76c88b5839577ad39e936296ad49a8bc00abcd5e041567a0c5d3c088a3516bc3a7f8f867a372e59f235b58e27c5f7befb34db9ee2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/95ef03420cd102ae0da071fbba1145df3c34778a4e33195440c2dfa954a15cc8a3d41daea9c67bc41d4727446d942e013322d3f1a30caae81b03ab756f8d8b0d"} 19:17:28 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 19:17:28 INFO - Writing to file /builds/slave/test/properties/blobber_files 19:17:28 INFO - Contents: 19:17:28 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/55471e0f1905cff977af3ea3c986fe765207aa39c7014f1b9ac220cd950e60a89df6a50e72d0a63c1dcf623b3b808d125564b16ab9e5f143584ab1c331e7dfec", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/4be2a1e89a5ccc742cc8afc76c88b5839577ad39e936296ad49a8bc00abcd5e041567a0c5d3c088a3516bc3a7f8f867a372e59f235b58e27c5f7befb34db9ee2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/95ef03420cd102ae0da071fbba1145df3c34778a4e33195440c2dfa954a15cc8a3d41daea9c67bc41d4727446d942e013322d3f1a30caae81b03ab756f8d8b0d"} 19:17:28 INFO - Running post-run listener: copy_logs_to_upload_dir 19:17:28 INFO - Copying logs to upload dir... 19:17:28 INFO - mkdir: /builds/slave/test/build/upload/logs 19:17:28 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1285.173268 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 25 secs) (at 2016-07-05 19:17:28.429090) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-05 19:17:28.432475) ========= 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.yyyD8cBPJx/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.W61jGDsixJ/Listeners TMPDIR=/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/55471e0f1905cff977af3ea3c986fe765207aa39c7014f1b9ac220cd950e60a89df6a50e72d0a63c1dcf623b3b808d125564b16ab9e5f143584ab1c331e7dfec", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/4be2a1e89a5ccc742cc8afc76c88b5839577ad39e936296ad49a8bc00abcd5e041567a0c5d3c088a3516bc3a7f8f867a372e59f235b58e27c5f7befb34db9ee2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/95ef03420cd102ae0da071fbba1145df3c34778a4e33195440c2dfa954a15cc8a3d41daea9c67bc41d4727446d942e013322d3f1a30caae81b03ab756f8d8b0d"} build_url:https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011243 build_url: 'https://queue.taskcluster.net/v1/task/Zdbr4DxLR32cH4pG8HyrYQ/artifacts/public/build/firefox-50.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/55471e0f1905cff977af3ea3c986fe765207aa39c7014f1b9ac220cd950e60a89df6a50e72d0a63c1dcf623b3b808d125564b16ab9e5f143584ab1c331e7dfec", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/4be2a1e89a5ccc742cc8afc76c88b5839577ad39e936296ad49a8bc00abcd5e041567a0c5d3c088a3516bc3a7f8f867a372e59f235b58e27c5f7befb34db9ee2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/95ef03420cd102ae0da071fbba1145df3c34778a4e33195440c2dfa954a15cc8a3d41daea9c67bc41d4727446d942e013322d3f1a30caae81b03ab756f8d8b0d"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-05 19:17:28.465558) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 19:17:28.465898) ========= 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.yyyD8cBPJx/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.W61jGDsixJ/Listeners TMPDIR=/var/folders/x6/sw5m1xh120z8118jjdxnyt0800000w/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.005150 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 19:17:28.515508) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-05 19:17:28.515838) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-05 19:17:28.516201) ========= ========= Total master_lag: 2.70 =========