builder: fx-team_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0126 starttime: 1476909174.82 results: success (0) buildid: 20161019101422 builduid: f7dff28ec4d84db6b702e4f113d0aa13 revision: 8bd0d7e850dd1e62fa088d99821a2072a9273c09 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:54.819763) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:54.820519) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:54.821020) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:54.845971) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:54.846363) ========= 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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners TMPDIR=/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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-10-19 13:32:54-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 28.2M=0s 2016-10-19 13:32:54 (28.2 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.123849 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:54.993136) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:54.993475) ========= 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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners TMPDIR=/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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.027703 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:55.043106) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-10-19 13:32:55.043488) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 8bd0d7e850dd1e62fa088d99821a2072a9273c09 --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 8bd0d7e850dd1e62fa088d99821a2072a9273c09 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners TMPDIR=/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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-10-19 13:32:55,115 truncating revision to first 12 chars 2016-10-19 13:32:55,115 Setting DEBUG logging. 2016-10-19 13:32:55,115 attempt 1/10 2016-10-19 13:32:55,115 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/8bd0d7e850dd?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-19 13:32:56,911 unpacking tar archive at: fx-team-8bd0d7e850dd/testing/mozharness/ program finished with exit code 0 elapsedTime=2.075113 ========= master_lag: 0.45 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-10-19 13:32:57.573590) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:57.574043) ========= script_repo_revision: 8bd0d7e850dd1e62fa088d99821a2072a9273c09 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:57.574660) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:57.574971) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-19 13:32:57.595988) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 15 secs) (at 2016-10-19 13:32:57.596308) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs-e10s --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', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners TMPDIR=/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:32:57 INFO - MultiFileLogger online at 20161019 13:32:57 in /builds/slave/test 13:32:57 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 13:32:57 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:32:57 INFO - {'append_to_log': False, 13:32:57 INFO - 'base_work_dir': '/builds/slave/test', 13:32:57 INFO - 'blob_upload_branch': 'Fx-Team', 13:32:57 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:32:57 INFO - 'branch': 'Fx-Team', 13:32:57 INFO - 'buildbot_json_path': 'buildprops.json', 13:32:57 INFO - 'config_files': ('talos/mac_config.py',), 13:32:57 INFO - 'default_actions': ('clobber', 13:32:57 INFO - 'read-buildbot-config', 13:32:57 INFO - 'download-and-extract', 13:32:57 INFO - 'populate-webroot', 13:32:57 INFO - 'create-virtualenv', 13:32:57 INFO - 'install', 13:32:57 INFO - 'run-tests'), 13:32:57 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:32:57 INFO - 'download_minidump_stackwalk': True, 13:32:57 INFO - 'download_symbols': 'ondemand', 13:32:57 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:32:57 INFO - 'tooltool.py': '/tools/tooltool.py', 13:32:57 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:32:57 INFO - '/tools/misc-python/virtualenv.py')}, 13:32:57 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:32:57 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:32:57 INFO - 'installer_path': 'installer.exe', 13:32:57 INFO - 'log_level': 'info', 13:32:57 INFO - 'log_name': 'talos', 13:32:57 INFO - 'log_to_console': True, 13:32:57 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 13:32:57 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 13:32:57 INFO - 'opt_config_files': (), 13:32:57 INFO - 'pip_index': False, 13:32:57 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 13:32:57 INFO - 'cmd': ('bash', 13:32:57 INFO - '-c', 13:32:57 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 13:32:57 INFO - 'enabled': True, 13:32:57 INFO - 'halt_on_failure': False, 13:32:57 INFO - 'name': 'check_screen_resolution'},), 13:32:57 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 13:32:57 INFO - 'cmd': ('bash', 13:32:57 INFO - '-c', 13:32:57 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 13:32:57 INFO - 'enabled': True, 13:32:57 INFO - 'halt_on_failure': False, 13:32:57 INFO - 'name': 'check_screen_resolution'},), 13:32:57 INFO - 'run_cmd_checks_enabled': True, 13:32:57 INFO - 'sps_profile': False, 13:32:57 INFO - 'sps_profile_interval': 0, 13:32:57 INFO - 'suite': 'dromaeojs-e10s', 13:32:57 INFO - 'system_bits': '32', 13:32:57 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:32:57 INFO - 'title': 't-yosemite-r7-0126', 13:32:57 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:32:57 INFO - 'use_talos_json': True, 13:32:57 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:32:57 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:32:57 INFO - 'work_dir': 'build'} 13:32:57 INFO - [mozharness: 2016-10-19 20:32:57.800177Z] Running clobber step. 13:32:57 INFO - Running pre-action listener: _resource_record_pre_action 13:32:57 INFO - Running main action method: clobber 13:32:57 INFO - rmtree: /builds/slave/test/build 13:32:57 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:33:00 INFO - Running post-action listener: _resource_record_post_action 13:33:00 INFO - [mozharness: 2016-10-19 20:33:00.099336Z] Finished clobber step (success) 13:33:00 INFO - [mozharness: 2016-10-19 20:33:00.099493Z] Running read-buildbot-config step. 13:33:00 INFO - Running pre-action listener: _resource_record_pre_action 13:33:00 INFO - Running main action method: read_buildbot_config 13:33:00 INFO - Using buildbot properties: 13:33:00 INFO - { 13:33:00 INFO - "project": "", 13:33:00 INFO - "product": "firefox", 13:33:00 INFO - "script_repo_revision": "production", 13:33:00 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs-e10s", 13:33:00 INFO - "repository": "", 13:33:00 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs-e10s", 13:33:00 INFO - "buildid": "20161019101422", 13:33:00 INFO - "pgo_build": "False", 13:33:00 INFO - "basedir": "/builds/slave/test", 13:33:00 INFO - "buildnumber": 798, 13:33:00 INFO - "slavename": "t-yosemite-r7-0126", 13:33:00 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 13:33:00 INFO - "platform": "yosemite_r7", 13:33:00 INFO - "scheduler": "tests-fx-team-macosx64-talos-8-3600", 13:33:00 INFO - "branch": "fx-team", 13:33:00 INFO - "repo_path": "integration/fx-team", 13:33:00 INFO - "revision": "8bd0d7e850dd1e62fa088d99821a2072a9273c09", 13:33:00 INFO - "stage_platform": "macosx64", 13:33:00 INFO - "builduid": "f7dff28ec4d84db6b702e4f113d0aa13", 13:33:00 INFO - "slavebuilddir": "test" 13:33:00 INFO - } 13:33:00 INFO - Found installer url https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg. 13:33:00 INFO - Running post-action listener: _resource_record_post_action 13:33:00 INFO - [mozharness: 2016-10-19 20:33:00.102519Z] Finished read-buildbot-config step (success) 13:33:00 INFO - [mozharness: 2016-10-19 20:33:00.102627Z] Running download-and-extract step. 13:33:00 INFO - Running pre-action listener: _resource_record_pre_action 13:33:00 INFO - Running main action method: download_and_extract 13:33:00 INFO - mkdir: /builds/slave/test/build/tests 13:33:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:00 INFO - trying https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json 13:33:00 INFO - Downloading https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 13:33:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json'}, attempt #1 13:33:01 INFO - Downloaded 1199 bytes. 13:33:01 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 13:33:01 INFO - Using the following test package requirements: 13:33:01 INFO - {u'common': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 13:33:01 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 13:33:01 INFO - u'firefox-52.0a1.en-US.mac.cppunittest.tests.zip'], 13:33:01 INFO - u'gtest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 13:33:01 INFO - u'firefox-52.0a1.en-US.mac.gtest.tests.zip'], 13:33:01 INFO - u'jittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 13:33:01 INFO - u'jsshell-mac.zip'], 13:33:01 INFO - u'mochitest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 13:33:01 INFO - u'firefox-52.0a1.en-US.mac.mochitest.tests.zip'], 13:33:01 INFO - u'mozbase': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 13:33:01 INFO - u'reftest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 13:33:01 INFO - u'firefox-52.0a1.en-US.mac.reftest.tests.zip'], 13:33:01 INFO - u'talos': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 13:33:01 INFO - u'firefox-52.0a1.en-US.mac.talos.tests.zip'], 13:33:01 INFO - u'web-platform': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 13:33:01 INFO - u'firefox-52.0a1.en-US.mac.web-platform.tests.zip'], 13:33:01 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 13:33:01 INFO - u'firefox-52.0a1.en-US.mac.xpcshell.tests.zip']} 13:33:01 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip'] for test suite category: common 13:33:01 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 13:33:01 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 13:33:01 INFO - Fetch https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 13:33:01 INFO - Http code: 200 13:33:01 INFO - via: 1.1 d2bd759914e30b1d5aee2929535c55f9.cloudfront.net (CloudFront) 13:33:01 INFO - x-amz-cf-id: AfQwZCr0z-boTw09fXGriUF3N20wIXGJEMePYTEFEJ4HAcnkXcPCpg== 13:33:01 INFO - x-amz-version-id: 9YYQyAWiO528e89a26kG.PxufOWrsK3M 13:33:02 INFO - Expected file size: 16500049 13:33:02 INFO - Obtained file size: 16500049 13:33:08 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip', u'firefox-52.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 13:33:08 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 13:33:08 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 13:33:08 INFO - Fetch https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 13:33:09 INFO - Http code: 200 13:33:09 INFO - via: 1.1 bb8a7ff26b131d51953dc2d3e19a2751.cloudfront.net (CloudFront) 13:33:09 INFO - x-amz-cf-id: 8Mrt-P7GY5edJgyMKlKTSINsS01A3PuoJdtL8UGfA7VHIuHgxZcO3Q== 13:33:09 INFO - x-amz-version-id: 9YYQyAWiO528e89a26kG.PxufOWrsK3M 13:33:09 INFO - Expected file size: 16500049 13:33:09 INFO - Obtained file size: 16500049 13:33:15 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip 13:33:15 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip'}, attempt #1 13:33:15 INFO - Fetch https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip into memory 13:33:16 INFO - Http code: 200 13:33:16 INFO - via: 1.1 b9a8ce441329f20cea895e08f19f1ec8.cloudfront.net (CloudFront) 13:33:16 INFO - x-amz-cf-id: bxVGL0dHKd8I_yNsF4Pf0XPsZwu7c1p6-i9oY9ATGDpNyZ88NLFOKg== 13:33:16 INFO - x-amz-version-id: cS5sae57Oo.YepVphgUrdaGvEaBQkTC5 13:33:17 INFO - Expected file size: 14409028 13:33:17 INFO - Obtained file size: 14409028 13:33:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:17 INFO - trying https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 13:33:17 INFO - Downloading https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg 13:33:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg'}, attempt #1 13:33:20 INFO - Downloaded 111646016 bytes. 13:33:20 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 13:33:20 INFO - mkdir: /builds/slave/test/properties 13:33:20 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:33:20 INFO - Writing to file /builds/slave/test/properties/build_url 13:33:20 INFO - Contents: 13:33:20 INFO - build_url:https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 13:33:20 INFO - Running post-action listener: _resource_record_post_action 13:33:20 INFO - Running post-action listener: set_extra_try_arguments 13:33:20 INFO - [mozharness: 2016-10-19 20:33:20.961931Z] Finished download-and-extract step (success) 13:33:20 INFO - [mozharness: 2016-10-19 20:33:20.962031Z] Running populate-webroot step. 13:33:20 INFO - Running pre-action listener: _resource_record_pre_action 13:33:20 INFO - Running main action method: populate_webroot 13:33:20 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:33:20 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:33:20 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:33:20 INFO - '--tppagecycles', 13:33:20 INFO - '7'], 13:33:20 INFO - 'tests': ['tsvgm']}}, 13:33:20 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:33:20 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 13:33:20 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:33:20 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 13:33:20 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:33:20 INFO - 'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:33:20 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:33:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:33:20 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:33:20 INFO - 'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['damp', 'tps']}, 13:33:20 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:33:20 INFO - 'tests': ['damp', 'tps']}, 13:33:20 INFO - 'g3': {'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['dromaeo_dom']}, 13:33:20 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:33:20 INFO - 'g4': {'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['basic_compositor_video']}, 13:33:20 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 13:33:20 INFO - 'other': {'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['a11yr', 13:33:20 INFO - 'ts_paint', 13:33:20 INFO - 'tpaint', 13:33:20 INFO - 'sessionrestore', 13:33:20 INFO - 'sessionrestore_no_auto_restore', 13:33:20 INFO - 'tabpaint']}, 13:33:20 INFO - 'other-e10s': {'tests': ['a11yr', 13:33:20 INFO - 'ts_paint', 13:33:20 INFO - 'tpaint', 13:33:20 INFO - 'sessionrestore', 13:33:20 INFO - 'sessionrestore_no_auto_restore', 13:33:20 INFO - 'tabpaint']}, 13:33:20 INFO - 'other-e10s_l64': {'tests': ['a11yr', 13:33:20 INFO - 'ts_paint', 13:33:20 INFO - 'tpaint', 13:33:20 INFO - 'sessionrestore', 13:33:20 INFO - 'sessionrestore_no_auto_restore', 13:33:20 INFO - 'tabpaint']}, 13:33:20 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 13:33:20 INFO - 'ts_paint', 13:33:20 INFO - 'tpaint', 13:33:20 INFO - 'sessionrestore', 13:33:20 INFO - 'sessionrestore_no_auto_restore', 13:33:20 INFO - 'tabpaint']}, 13:33:20 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['a11yr', 13:33:20 INFO - 'ts_paint', 13:33:20 INFO - 'tpaint', 13:33:20 INFO - 'sessionrestore', 13:33:20 INFO - 'sessionrestore_no_auto_restore', 13:33:20 INFO - 'tabpaint']}, 13:33:20 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['a11yr', 13:33:20 INFO - 'ts_paint', 13:33:20 INFO - 'tpaint', 13:33:20 INFO - 'sessionrestore', 13:33:20 INFO - 'sessionrestore_no_auto_restore', 13:33:20 INFO - 'tabpaint']}, 13:33:20 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['tsvgx', 13:33:20 INFO - 'tsvgr_opacity', 13:33:20 INFO - 'tart', 13:33:20 INFO - 'tscrollx', 13:33:20 INFO - 'cart']}, 13:33:20 INFO - 'svgr-e10s': {'tests': ['tsvgx', 13:33:20 INFO - 'tsvgr_opacity', 13:33:20 INFO - 'tart', 13:33:20 INFO - 'tscrollx', 13:33:20 INFO - 'cart']}, 13:33:20 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:33:20 INFO - 'talos_options': ['--disable-e10s'], 13:33:20 INFO - 'tests': ['tp5o']}, 13:33:20 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:33:20 INFO - 'tests': ['tp5o']}, 13:33:20 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:33:20 INFO - 'talos_options': ['--disable-e10s', 13:33:20 INFO - '--xperf_path', 13:33:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:33:20 INFO - 'tests': ['tp5n']}, 13:33:20 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:33:20 INFO - 'talos_options': ['--xperf_path', 13:33:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:33:20 INFO - 'tests': ['tp5n']}}, 13:33:20 INFO - 'talos.zip': {'path': '', 13:33:20 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:33:20 INFO - Running post-action listener: _resource_record_post_action 13:33:20 INFO - [mozharness: 2016-10-19 20:33:20.981262Z] Finished populate-webroot step (success) 13:33:20 INFO - [mozharness: 2016-10-19 20:33:20.981389Z] Running create-virtualenv step. 13:33:20 INFO - Running pre-action listener: _resource_record_pre_action 13:33:20 INFO - Running main action method: create_virtualenv 13:33:20 INFO - Creating virtualenv /builds/slave/test/build/venv 13:33:20 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 13:33:20 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:33:21 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:33:21 INFO - Using real prefix '/tools/python27' 13:33:21 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:33:21 INFO - Installing distribute.............................................................................................................................................................................................done. 13:33:24 INFO - Installing pip.................done. 13:33:24 INFO - Return code: 0 13:33:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 13:33:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 13:33:24 INFO - Reading from file tmpfile_stdout 13:33:24 INFO - Output received: 13:33:24 INFO - pip 1.5.5 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 13:33:24 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:33:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:24 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 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:24 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 13:33:24 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 13:33:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:24 INFO - 'HOME': '/Users/cltbld', 13:33:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:24 INFO - 'LOGNAME': 'cltbld', 13:33:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:24 INFO - 'MOZ_NO_REMOTE': '1', 13:33:24 INFO - 'NO_EM_RESTART': '1', 13:33:24 INFO - 'PAGER': '/bin/cat', 13:33:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:24 INFO - 'PWD': '/builds/slave/test', 13:33:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:24 INFO - 'SHELL': '/bin/bash', 13:33:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:24 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:24 INFO - 'USER': 'cltbld', 13:33:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:24 INFO - 'XPC_FLAGS': '0x0', 13:33:24 INFO - 'XPC_SERVICE_NAME': '0', 13:33:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:25 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 13:33:25 INFO - Cleaning up... 13:33:25 INFO - Return code: 0 13:33:25 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 13:33:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 13:33:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 13:33:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:25 INFO - 'HOME': '/Users/cltbld', 13:33:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:25 INFO - 'LOGNAME': 'cltbld', 13:33:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:25 INFO - 'MOZ_NO_REMOTE': '1', 13:33:25 INFO - 'NO_EM_RESTART': '1', 13:33:25 INFO - 'PAGER': '/bin/cat', 13:33:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:25 INFO - 'PWD': '/builds/slave/test', 13:33:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:25 INFO - 'SHELL': '/bin/bash', 13:33:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:25 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:25 INFO - 'USER': 'cltbld', 13:33:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:25 INFO - 'XPC_FLAGS': '0x0', 13:33:25 INFO - 'XPC_SERVICE_NAME': '0', 13:33:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:25 INFO - Downloading/unpacking psutil>=3.1.1 13:33:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:33:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:33:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:33:28 INFO - Installing collected packages: psutil 13:33:28 INFO - Running setup.py install for psutil 13:33:29 INFO - building 'psutil._psutil_osx' extension 13:33:29 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 13:33:29 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 13:33:29 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 13:33:29 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 13:33:29 INFO - building 'psutil._psutil_posix' extension 13:33:29 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 13:33:29 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 13:33:29 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 13:33:29 INFO - ^ 13:33:29 INFO - 1 warning generated. 13:33:29 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 13:33:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:33:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:33:30 INFO - Successfully installed psutil 13:33:30 INFO - Cleaning up... 13:33:30 INFO - Return code: 0 13:33:30 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 13:33:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:30 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 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:30 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 13:33:30 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 13:33:30 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:30 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:30 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:30 INFO - 'HOME': '/Users/cltbld', 13:33:30 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:30 INFO - 'LOGNAME': 'cltbld', 13:33:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:30 INFO - 'MOZ_NO_REMOTE': '1', 13:33:30 INFO - 'NO_EM_RESTART': '1', 13:33:30 INFO - 'PAGER': '/bin/cat', 13:33:30 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:30 INFO - 'PWD': '/builds/slave/test', 13:33:30 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:30 INFO - 'SHELL': '/bin/bash', 13:33:30 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:30 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:30 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:30 INFO - 'USER': 'cltbld', 13:33:30 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:30 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:30 INFO - 'XPC_FLAGS': '0x0', 13:33:30 INFO - 'XPC_SERVICE_NAME': '0', 13:33:30 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:30 INFO - Downloading/unpacking mozsystemmonitor==0.3 13:33:30 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 13:33:30 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 13:33:30 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 13:33:30 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 13:33:30 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 13:33:30 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 13:33:32 INFO - Downloading mozsystemmonitor-0.3.tar.gz 13:33:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:33:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 13:33:32 INFO - Installing collected packages: mozsystemmonitor 13:33:32 INFO - Running setup.py install for mozsystemmonitor 13:33:33 INFO - Successfully installed mozsystemmonitor 13:33:33 INFO - Cleaning up... 13:33:33 INFO - Return code: 0 13:33:33 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 13:33:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:33 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 13:33:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 13:33:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:33 INFO - 'HOME': '/Users/cltbld', 13:33:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:33 INFO - 'LOGNAME': 'cltbld', 13:33:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:33 INFO - 'MOZ_NO_REMOTE': '1', 13:33:33 INFO - 'NO_EM_RESTART': '1', 13:33:33 INFO - 'PAGER': '/bin/cat', 13:33:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:33 INFO - 'PWD': '/builds/slave/test', 13:33:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:33 INFO - 'SHELL': '/bin/bash', 13:33:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:33 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:33 INFO - 'USER': 'cltbld', 13:33:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:33 INFO - 'XPC_FLAGS': '0x0', 13:33:33 INFO - 'XPC_SERVICE_NAME': '0', 13:33:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:33 INFO - Downloading/unpacking jsonschema==2.5.1 13:33:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:35 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:33:35 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 13:33:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:36 INFO - Downloading functools32-3.2.3-2.tar.gz 13:33:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:33:36 INFO - warning: no files found matching '*.txt' 13:33:36 INFO - no previously-included directories found matching 'build' 13:33:36 INFO - no previously-included directories found matching 'dist' 13:33:36 INFO - no previously-included directories found matching '.git*' 13:33:36 INFO - Installing collected packages: jsonschema, functools32 13:33:36 INFO - Running setup.py install for functools32 13:33:36 INFO - warning: no files found matching '*.txt' 13:33:36 INFO - no previously-included directories found matching 'build' 13:33:36 INFO - no previously-included directories found matching 'dist' 13:33:36 INFO - no previously-included directories found matching '.git*' 13:33:36 INFO - Successfully installed jsonschema functools32 13:33:36 INFO - Cleaning up... 13:33:36 INFO - Return code: 0 13:33:36 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 13:33:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 13:33:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 13:33:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:36 INFO - 'HOME': '/Users/cltbld', 13:33:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:36 INFO - 'LOGNAME': 'cltbld', 13:33:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:36 INFO - 'MOZ_NO_REMOTE': '1', 13:33:36 INFO - 'NO_EM_RESTART': '1', 13:33:36 INFO - 'PAGER': '/bin/cat', 13:33:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:36 INFO - 'PWD': '/builds/slave/test', 13:33:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:36 INFO - 'SHELL': '/bin/bash', 13:33:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:36 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:36 INFO - 'USER': 'cltbld', 13:33:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:36 INFO - 'XPC_FLAGS': '0x0', 13:33:36 INFO - 'XPC_SERVICE_NAME': '0', 13:33:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:36 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 13:33:36 INFO - Cleaning up... 13:33:36 INFO - Return code: 0 13:33:36 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:33:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:36 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 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:36 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 13:33:36 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 13:33:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:36 INFO - 'HOME': '/Users/cltbld', 13:33:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:36 INFO - 'LOGNAME': 'cltbld', 13:33:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:36 INFO - 'MOZ_NO_REMOTE': '1', 13:33:36 INFO - 'NO_EM_RESTART': '1', 13:33:36 INFO - 'PAGER': '/bin/cat', 13:33:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:36 INFO - 'PWD': '/builds/slave/test', 13:33:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:36 INFO - 'SHELL': '/bin/bash', 13:33:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:36 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:36 INFO - 'USER': 'cltbld', 13:33:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:36 INFO - 'XPC_FLAGS': '0x0', 13:33:36 INFO - 'XPC_SERVICE_NAME': '0', 13:33:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:37 INFO - Downloading/unpacking blobuploader==1.2.4 13:33:37 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 13:33:37 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 13:33:37 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 13:33:37 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 13:33:37 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 13:33:37 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 13:33:39 INFO - Downloading blobuploader-1.2.4.tar.gz 13:33:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:33:39 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:33:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:33:40 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:33:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:33:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:33:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:33:40 INFO - Downloading docopt-0.6.1.tar.gz 13:33:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:33:41 INFO - Installing collected packages: blobuploader, requests, docopt 13:33:41 INFO - Running setup.py install for blobuploader 13:33:41 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:33:41 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:33:41 INFO - Running setup.py install for requests 13:33:41 INFO - Running setup.py install for docopt 13:33:41 INFO - Successfully installed blobuploader requests docopt 13:33:41 INFO - Cleaning up... 13:33:41 INFO - Return code: 0 13:33:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:33:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:41 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 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:41 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 13:33:41 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 13:33:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:41 INFO - 'HOME': '/Users/cltbld', 13:33:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:41 INFO - 'LOGNAME': 'cltbld', 13:33:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:41 INFO - 'MOZ_NO_REMOTE': '1', 13:33:41 INFO - 'NO_EM_RESTART': '1', 13:33:41 INFO - 'PAGER': '/bin/cat', 13:33:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:41 INFO - 'PWD': '/builds/slave/test', 13:33:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:41 INFO - 'SHELL': '/bin/bash', 13:33:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:41 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:41 INFO - 'USER': 'cltbld', 13:33:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:41 INFO - 'XPC_FLAGS': '0x0', 13:33:41 INFO - 'XPC_SERVICE_NAME': '0', 13:33:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-NZpQJ6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-h0zEfd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-cfhWUp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-NCbm4D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-2inuOR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-lZuelR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-3Im9YA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-21uU8Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:33:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:33:42 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-T6T4gX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:33:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:33:43 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-wNjXtw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:33:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:33:43 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-J1H8CF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:33:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:33:43 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-atwbhe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:33:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:33:43 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-_pOIJj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:33:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:33:43 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-ux6X62-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:33:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:33:43 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-FDK0OL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:33:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:33:43 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-ADDn1M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:33:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:33:43 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-djC3xl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:33:43 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:33:43 INFO - Running setup.py install for manifestparser 13:33:44 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:33:44 INFO - Running setup.py install for mozcrash 13:33:44 INFO - Running setup.py install for mozdebug 13:33:44 INFO - Running setup.py install for mozdevice 13:33:44 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:33:44 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:33:44 INFO - Running setup.py install for mozfile 13:33:44 INFO - Running setup.py install for mozhttpd 13:33:44 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:33:44 INFO - Running setup.py install for mozinfo 13:33:44 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:33:44 INFO - Running setup.py install for mozInstall 13:33:45 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Running setup.py install for mozleak 13:33:45 INFO - Running setup.py install for mozlog 13:33:45 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Running setup.py install for moznetwork 13:33:45 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Running setup.py install for mozprocess 13:33:45 INFO - Running setup.py install for mozprofile 13:33:45 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:33:45 INFO - Running setup.py install for mozrunner 13:33:46 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:33:46 INFO - Running setup.py install for mozscreenshot 13:33:46 INFO - Running setup.py install for moztest 13:33:46 INFO - Running setup.py install for mozversion 13:33:46 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:33:46 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:33:46 INFO - Cleaning up... 13:33:46 INFO - Return code: 0 13:33:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:33: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:46 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 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:46 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 13:33:46 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 13:33:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:46 INFO - 'HOME': '/Users/cltbld', 13:33:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:46 INFO - 'LOGNAME': 'cltbld', 13:33:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:46 INFO - 'MOZ_NO_REMOTE': '1', 13:33:46 INFO - 'NO_EM_RESTART': '1', 13:33:46 INFO - 'PAGER': '/bin/cat', 13:33:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:46 INFO - 'PWD': '/builds/slave/test', 13:33:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:46 INFO - 'SHELL': '/bin/bash', 13:33:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:46 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:46 INFO - 'USER': 'cltbld', 13:33:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:46 INFO - 'XPC_FLAGS': '0x0', 13:33:46 INFO - 'XPC_SERVICE_NAME': '0', 13:33:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:33:46 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-vn9S31-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:33:46 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)) 13:33:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:33:46 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-gKtuH5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:33:46 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)) 13:33:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:33:46 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-7c4wjl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:33:47 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-K4sM5G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:33:47 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-FE7jDu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:33:47 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-4zNyl9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:33:47 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-KEuU2n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:33:47 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-dAc3RR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:33:47 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-G3V_SS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:33:47 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-UrSptk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:33:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-HHMAgd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:33:47 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)) 13:33:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:33:47 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-bPX9cO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:33:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 13:33:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:33:48 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-h9674Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:33:48 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)) 13:33:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:33:48 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-jaRahh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:33:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 13:33:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:33:48 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-BcduaG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:33:48 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)) 13:33:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:33:48 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-_3iNvH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:33:48 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)) 13:33:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:33:48 INFO - Running setup.py (path:/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/pip-G4bEM1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:33:48 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)) 13:33:48 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)) 13:33:48 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)) 13:33:48 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)) 13:33:48 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)) 13:33:48 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)) 13:33:48 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:33:48 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 13:33:48 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 13:33:48 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 13:33:48 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 13:33:48 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 13:33:48 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 13:33:51 INFO - Downloading blessings-1.6.tar.gz 13:33:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:33:51 INFO - Installing collected packages: blessings 13:33:51 INFO - Running setup.py install for blessings 13:33:51 INFO - Successfully installed blessings 13:33:51 INFO - Cleaning up... 13:33:51 INFO - Return code: 0 13:33:51 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:33:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:33:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:33:51 INFO - Reading from file tmpfile_stdout 13:33:51 INFO - Current package versions: 13:33:51 INFO - blessings == 1.6 13:33:51 INFO - blobuploader == 1.2.4 13:33:51 INFO - docopt == 0.6.1 13:33:51 INFO - functools32 == 3.2.3-2 13:33:51 INFO - jsonschema == 2.5.1 13:33:51 INFO - manifestparser == 1.1 13:33:51 INFO - mozInstall == 1.12 13:33:51 INFO - mozcrash == 0.17 13:33:51 INFO - mozdebug == 0.1 13:33:51 INFO - mozdevice == 0.48 13:33:51 INFO - mozfile == 1.2 13:33:51 INFO - mozhttpd == 0.7 13:33:51 INFO - mozinfo == 0.9 13:33:51 INFO - mozleak == 0.1 13:33:51 INFO - mozlog == 3.4 13:33:51 INFO - moznetwork == 0.27 13:33:51 INFO - mozprocess == 0.23 13:33:51 INFO - mozprofile == 0.28 13:33:51 INFO - mozrunner == 6.12 13:33:51 INFO - mozscreenshot == 0.1 13:33:51 INFO - mozsystemmonitor == 0.3 13:33:51 INFO - moztest == 0.7 13:33:51 INFO - mozversion == 1.4 13:33:51 INFO - psutil == 3.1.1 13:33:51 INFO - requests == 1.2.3 13:33:51 INFO - wsgiref == 0.1.2 13:33:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:33:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:52 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 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33:52 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 13:33:52 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 13:33:52 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:52 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:52 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:52 INFO - 'HOME': '/Users/cltbld', 13:33:52 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:52 INFO - 'LOGNAME': 'cltbld', 13:33:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:52 INFO - 'MOZ_NO_REMOTE': '1', 13:33:52 INFO - 'NO_EM_RESTART': '1', 13:33:52 INFO - 'PAGER': '/bin/cat', 13:33:52 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:52 INFO - 'PWD': '/builds/slave/test', 13:33:52 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:52 INFO - 'SHELL': '/bin/bash', 13:33:52 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:52 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:52 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:52 INFO - 'USER': 'cltbld', 13:33:52 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:52 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:52 INFO - 'XPC_FLAGS': '0x0', 13:33:52 INFO - 'XPC_SERVICE_NAME': '0', 13:33:52 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 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)) 13:33:52 INFO - Cleaning up... 13:33:52 INFO - Return code: 0 13:33:52 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:33:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:33:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:33:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:33: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']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1020af490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102025570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0815da410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, '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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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 13:33: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'] in /builds/slave/test/build 13:33: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 13:33:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:33:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:33:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:33:53 INFO - 'HOME': '/Users/cltbld', 13:33:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:33:53 INFO - 'LOGNAME': 'cltbld', 13:33:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:53 INFO - 'MOZ_NO_REMOTE': '1', 13:33:53 INFO - 'NO_EM_RESTART': '1', 13:33:53 INFO - 'PAGER': '/bin/cat', 13:33:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:33:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:53 INFO - 'PWD': '/builds/slave/test', 13:33:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:33:53 INFO - 'SHELL': '/bin/bash', 13:33:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:33:53 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:33:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:33:53 INFO - 'USER': 'cltbld', 13:33:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:33:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:33:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:53 INFO - 'XPC_FLAGS': '0x0', 13:33:53 INFO - 'XPC_SERVICE_NAME': '0', 13:33:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:33:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:33:53 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 13:33:53 INFO - Cleaning up... 13:33:53 INFO - Return code: 0 13:33:53 INFO - Running post-action listener: _resource_record_post_action 13:33:53 INFO - Running post-action listener: _start_resource_monitoring 13:33:53 INFO - Starting resource monitoring. 13:33:53 INFO - [mozharness: 2016-10-19 20:33:53.446771Z] Finished create-virtualenv step (success) 13:33:53 INFO - [mozharness: 2016-10-19 20:33:53.447749Z] Running install step. 13:33:53 INFO - Running pre-action listener: _resource_record_pre_action 13:33:53 INFO - Running main action method: install 13:33:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:33:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:33:53 INFO - Reading from file tmpfile_stdout 13:33:53 INFO - Detecting whether we're running mozinstall >=1.0... 13:33:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:33:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:33:53 INFO - Reading from file tmpfile_stdout 13:33:53 INFO - Output received: 13:33:53 INFO - Usage: mozinstall [options] installer 13:33:53 INFO - Options: 13:33:53 INFO - -h, --help show this help message and exit 13:33:53 INFO - -d DEST, --destination=DEST 13:33:53 INFO - Directory to install application into. [default: 13:33:53 INFO - "/builds/slave/test"] 13:33:53 INFO - --app=APP Application being installed. [default: firefox] 13:33:53 INFO - mkdir: /builds/slave/test/build/application 13:33:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 13:33:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 13:34:28 INFO - Reading from file tmpfile_stdout 13:34:28 INFO - Output received: 13:34:28 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 13:34:28 INFO - Running post-action listener: _resource_record_post_action 13:34:28 INFO - [mozharness: 2016-10-19 20:34:28.377077Z] Finished install step (success) 13:34:28 INFO - [mozharness: 2016-10-19 20:34:28.377215Z] Running run-tests step. 13:34:28 INFO - Running pre-action listener: _resource_record_pre_action 13:34:28 INFO - Running main action method: run_tests 13:34:28 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 13:34:28 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 13:34:28 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 13:34:28 INFO - 2016-10-19 13:34:28.391 screenresolution[1643:7701] starting screenresolution argv=screenresolution get 13:34:28 INFO - 2016-10-19 13:34:28.394 screenresolution[1643:7701] Display 0: 1600x1200x32@60 13:34:28 INFO - 2016-10-19 13:34:28.401 screenresolution[1644:7703] starting screenresolution argv=screenresolution list 13:34:28 INFO - Available Modes on Display 0 13:34:28 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 13:34:28 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 13:34:28 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 13:34:28 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 13:34:28 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 13:34:28 INFO - Intel Iris: 13:34:28 INFO - Chipset Model: Intel Iris 13:34:28 INFO - Type: GPU 13:34:28 INFO - Bus: Built-In 13:34:28 INFO - VRAM (Dynamic, Max): 1536 MB 13:34:28 INFO - Vendor: Intel (0x8086) 13:34:28 INFO - Device ID: 0x0a2e 13:34:28 INFO - Revision ID: 0x0009 13:34:28 INFO - Displays: 13:34:28 INFO - Display: 13:34:28 INFO - Resolution: 1600 x 1200 @ 60 Hz 13:34:28 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 13:34:28 INFO - Display Serial Number: 1600x1200 60 13:34:28 INFO - Main Display: Yes 13:34:28 INFO - Mirror: Off 13:34:28 INFO - Online: Yes 13:34:28 INFO - Rotation: Supported 13:34:28 INFO - Return code: 0 13:34:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:34:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:34:28 INFO - Python 2.7.3 13:34:28 INFO - Return code: 0 13:34:28 INFO - grabbing minidump binary from tooltool 13:34:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:34:28 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 0x101ec3d30>, '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 0x101ce9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101ebbb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:34:28 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 13:34:28 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 13:34:28 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 13:34:28 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:34:28 INFO - Return code: 0 13:34:28 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 13:34:28 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:34:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:34:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 13:34:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:34:28 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-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0126', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 13:34:28 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-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0126 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 13:34:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IdZxdI2f3Q/Render', 13:34:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:34:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:34:28 INFO - 'HOME': '/Users/cltbld', 13:34:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:34:28 INFO - 'LOGNAME': 'cltbld', 13:34:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:34:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 13:34:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:28 INFO - 'MOZ_NO_REMOTE': '1', 13:34:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:34:28 INFO - 'NO_EM_RESTART': '1', 13:34:28 INFO - 'PAGER': '/bin/cat', 13:34:28 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:34:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:28 INFO - 'PWD': '/builds/slave/test', 13:34:28 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:34:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:34:28 INFO - 'SHELL': '/bin/bash', 13:34:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.gmDRfiMXf9/Listeners', 13:34:28 INFO - 'TMPDIR': '/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/', 13:34:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:34:28 INFO - 'USER': 'cltbld', 13:34:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:34:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:34:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:28 INFO - 'XPC_FLAGS': '0x0', 13:34:28 INFO - 'XPC_SERVICE_NAME': '0', 13:34:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:34:28 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0126', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 13:34:28 INFO - mozversion application_buildid: 20161019101422 13:34:28 INFO - mozversion application_changeset: 8bd0d7e850dd1e62fa088d99821a2072a9273c09 13:34:28 INFO - mozversion application_display_name: Nightly 13:34:28 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:34:28 INFO - mozversion application_name: Firefox 13:34:28 INFO - mozversion application_remotingname: firefox 13:34:28 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 13:34:28 INFO - mozversion application_vendor: Mozilla 13:34:28 INFO - mozversion application_version: 52.0a1 13:34:28 INFO - mozversion platform_buildid: 20161019101422 13:34:28 INFO - mozversion platform_changeset: 8bd0d7e850dd1e62fa088d99821a2072a9273c09 13:34:28 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 13:34:28 INFO - mozversion platform_version: 52.0a1 13:34:28 INFO - using testdate: 1476909268 13:34:28 INFO - actual date: 1476909268 13:34:28 INFO - starting webserver on 'localhost:49273' 13:34:28 INFO - SUITE-START | Running 2 tests 13:34:28 INFO - TEST-START | dromaeo_css 13:34:28 INFO - operating with platform_type : mac_ 13:34:28 INFO - Initialising browser for dromaeo_css test... 13:34:28 INFO - TEST-INFO | started process 1654 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/tmp77ZzQL/profile http://localhost:49273/getInfo.html) 13:34:31 INFO - PROCESS | 1654 | 2016-10-19 13:34:31.717 plugin-container[1656:7852] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x8d3f, name = 'com.apple.tsm.portname' 13:34:31 INFO - PROCESS | 1654 | See /usr/include/servers/bootstrap_defs.h for the error codes. 13:34:31 INFO - PROCESS | 1654 | 2016-10-19 13:34:31.720 plugin-container[1656:7852] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x900b, name = 'com.apple.CFPasteboardClient' 13:34:31 INFO - PROCESS | 1654 | See /usr/include/servers/bootstrap_defs.h for the error codes. 13:34:31 INFO - PROCESS | 1654 | 2016-10-19 13:34:31.720 plugin-container[1656:7852] Failed to allocate communication port for com.apple.CFPasteboardClient; this is likely due to sandbox restrictions 13:34:31 INFO - PROCESS | 1654 | __metrics Screen width/height:1600/1200 13:34:31 INFO - PROCESS | 1654 | colorDepth:24 13:34:31 INFO - PROCESS | 1654 | Browser inner width/height: 1024/689 13:34:31 INFO - PROCESS | 1654 | __metrics 13:34:31 ERROR - PROCESS | 1654 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3097: TypeError: this.tabs is undefined 13:34:32 INFO - TEST-INFO | 1654: exit 0 13:34:32 INFO - Browser initialized. 13:34:32 INFO - Running cycle 1/1 for dromaeo_css test... 13:34:32 INFO - TEST-INFO | started process 1657 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/tmp77ZzQL/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:34:35 INFO - PROCESS | 1657 | 2016-10-19 13:34:35.009 plugin-container[1658:7970] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x863f, name = 'com.apple.tsm.portname' 13:34:35 INFO - PROCESS | 1657 | See /usr/include/servers/bootstrap_defs.h for the error codes. 13:34:35 INFO - PROCESS | 1657 | 2016-10-19 13:34:35.010 plugin-container[1658:7970] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x471b, name = 'com.apple.CFPasteboardClient' 13:34:35 INFO - PROCESS | 1657 | See /usr/include/servers/bootstrap_defs.h for the error codes. 13:34:35 INFO - PROCESS | 1657 | 2016-10-19 13:34:35.010 plugin-container[1658:7970] Failed to allocate communication port for com.apple.CFPasteboardClient; this is likely due to sandbox restrictions 13:34:44 INFO - PROCESS | 1657 | RSS: Main: 237076480 13:34:44 INFO - PROCESS | 1657 | 13:35:34 INFO - PROCESS | 1657 | 1476909334344 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] 13:37:48 INFO - PROCESS | 1657 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49273/tests/dromaeo/cssquery-ext.html) 13:37:49 INFO - PROCESS | 1657 | RSS: Main: 251502592 13:37:49 INFO - PROCESS | 1657 | 13:40:52 INFO - PROCESS | 1657 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-ext.html (next: http://localhost:49273/tests/dromaeo/cssquery-jquery.html) 13:40:52 INFO - PROCESS | 1657 | RSS: Main: 263757824 13:40:52 INFO - PROCESS | 1657 | 13:43:55 INFO - PROCESS | 1657 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49273/tests/dromaeo/cssquery-mootools.html) 13:43:55 INFO - PROCESS | 1657 | RSS: Main: 268464128 13:43:55 INFO - PROCESS | 1657 | 13:46:57 INFO - PROCESS | 1657 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49273/tests/dromaeo/cssquery-prototype.html) 13:46:58 INFO - PROCESS | 1657 | RSS: Main: 268247040 13:46:58 INFO - PROCESS | 1657 | 13:50:01 INFO - PROCESS | 1657 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49273/tests/dromaeo/cssquery-yui.html) 13:50:01 INFO - PROCESS | 1657 | RSS: Main: 273625088 13:50:01 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-yui.html (next: http://localhost:49273/tests/dromaeo/cssquery-dojo.html) 13:53:04 INFO - PROCESS | 1657 | RSS: Main: 276168704 13:53:04 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | __start_tp_report 13:53:04 INFO - PROCESS | 1657 | _x_x_mozilla_page_load 13:53:04 INFO - PROCESS | 1657 | _x_x_mozilla_page_load_details 13:53:04 INFO - PROCESS | 1657 | |i|pagename|runs| 13:53:04 INFO - PROCESS | 1657 | |0;dojo.html;3377.594688637364;3403.2172600301933;3429.7084747796434;3435.433153529668;3450.08572728227;4280.3151495760685;5472.960137573863;5657.207990881269;5698.914516282254;5708.200851880735;4826.444958829736;5650.915236271459;5787.334456537489;5793;5799.855003624912;5233.764480598373;5303.761330740107;5306.893862122755;5390;5390.73046347683;5344.545713614348;5357.624966252364;5365;5373.328333958255;5400.567954563645;5352.866178345534;5354.437784032679;5356.437574054727;5358.65168764031;5382.4886635769535;5330.626856120092;5342.038433082043;5342.759575819097;5352;5356.892862142774;5174.870628234325;5260.289860868772;5297.337832770903;5315.681059136464;5335.493128152819;5755.107958266433;5782.710864456761;5875.706214689249;5893.410658934115;5947.078202878561;6086.726097325587;6194.721237544276;6227.968860155715;6237.844053898643;6262.843428914268;6148.739508400812;6178.443940045373;6180.84547886302;6198.132261483396;6255.78104766331;5936.436038576328;5937.732802023919;5957.4042595740075;5968.582199246098;5993.370696076936;6365.681715914186;6372.107904893319;6382.904256436157;6383.585066970632;6404.839879003062;5986.790462333797;6108.969455152695;6119.755209791648;6120;6204.844878877974;6104.26748790148;6207.6275423474735;6215.12988181655;6218.22272215973;6229.968850155811;6189.659568723673;6211.378862113753;6215.34738852414;6216.098665693449;6245.469135123474;6063.120847477179;6122.794608434074;6189.226346706661;6206.844828879314;6222.782202622977;4939.3084968104495;4952.430470495867;4969;4987.276844857475;5019.548240658358;4408.9859332353735;4416.734995900256;4436.534163912807;4444.711093778894;4476.239039363316;5741.1388291756575;5841.912371314434;5932.584719069624;5957.165996760457;5968.910466343008;4841.467438581753;5149.897002059938;5584.771350302927;5760.711964401763;6160.630362178284;4927.728974906343;5625.128105143709;5920.082387229986;5923.940760592425;5967.343592204854;4529.818807247739;5288.524032837063;5334.386545547234;5426.75579598919;5431.2667789847865;6221.688915554295;6454.096426500294;6456.451201647818;6482.546221764431;6482.643454610042;5223.425423203368;6109.860177052684;6121.510279177566;6148.661823599745;6251.437370636664;6422.165118534561;6447.097406363019;6448.355164483514;6482.189726284215;6489.837754056186;6209.59637623553;6219.875602488016;6241.563090583615;6259.718312675849;6270.2475702915945;6107.083937409247;6121.908171377344;6147.493864003348;6149.708561202197;6178.907316390168;6151.84620384494;6152.661603611844;6153.107799369156;6162.845928851814;6185.628862268279;6048.788292409745;6122.479589234965;6145.446909778141;6173.043178307369;6178.165947597017;5814.476697097281;5981.222441082631;6019.729112189874;6023.548233882389;6032.517398608013;6159.860425821237;6165.229346331708;6189.597676151036;6212.596181248205;6237.563370564017;6032.90950635732;6071.726772295169;6084.269887613515;6087.564275373243;6108.827782940854 13:53:04 INFO - PROCESS | 1657 | |1;ext.html;466.7619514047835;500.68206688752633;524.7874610782633;529.5181384939704;559.8264537993223;37572;40860.182796344096;41123.383149252746;43107.78446107765;43248.35127473083;39467.80266098673;42238.94402639935;42395;42786.786066069704;43545.78227108868;8849.823003539941;9633.855492167622;9636.277279204052;9646;9666.661666841663;9523.238140948708;9574.760630984212;9582.616695332179;9589.760255993586;9616.134547890688;9546.665866694668;9586.952065239664;9632.277579181555;9638.987906269846;9643.083907028857;9441.81116377672;9566;9596.712098636983;9609.759756006086;9614.326997110205;9537.1893389062;9605.327627066108;9622.37454565451;9646.565904534313;9654;40173.995650108984;40264.194716105805;40464.79767601172;40527;40602.390964135564;3339.282054358325;3345.832708364572;3392.112664818192;3392.7794693344854;3495.755297129202;30209.848950755324;30274.243143921358;30901.690983090106;31223.687763122307;31691.20771980696;3168.429682657121;3173.730232930204;3189.122991177445;3282.3107147499054;3327.73378129749;486662;487399;489864;490657.54671226774;495319;61173.77652447015;61246.85636002719;61483.69258153681;61556.076658849255;61698.76602467926;55773.32680019606;64339.71320573562;64586.70826583536;64741;64808.35191648117;14144.504942326968;15522.991005584601;15762.369505219893;15801.209939502978;15852;12486.875131248753;12566.120371573903;12569.183003104768;12587.559435419716;12602.991760659126;15529.534113976599;17625.532197661996;19045;19204.423867283724;19249.32627358036;3295.3244584860527;7806.765797026098;8151.388645851584;8226.629801658939;8254.339652827759;859.7291853066264;947.7535840681335;1002.3134153105146;1024.2676486312323;1065.2969040433277;28421.431571368455;28855.855720721684;30069.548956765666;30310.242243944078;30757.077287681404;1036.486938965217;1102.6691992402248;1119.652907598647;1129.13056946151;1136.8237923121928;15316.463923762614;15735.291911863993;15758.76361854573;15905.443309484113;16176;573701;647755;653446;656723.716381415;658110;57941.130883036785;58371.83256334849;58489.70755146197;58671.706641467375;58676.7066164675;1330.7205486847677;1359;1369.7739872920856;1384.7092110656674;1390.0547627613118;29269.560956585243;30030.399392012474;30185.396292074474;30495.54256686107;30749.692503074682;50394.74802625964;50511.24233136432;50649;50666.74666626643;50718;498274;503038;503065;595062;601099;26335.893128550055;26519.469610607295;26773.06294279769;26866;26892.73107268902;46505;46545.53454465547;48176.5182348172;48548.757256213496;48627;38587.421188681634;39081.80459097686;39487;40606.57876974292;41067.76796696104;33257.16857078592;38055.477780888454;38825;39465.210695786496;39808.80095599504;38084.619153808104;38108.23783524259;38620;38997;39016.21967560576;30877.8456107718;34445.31109377849;34923.47614785831;35396.46905296371;35468;21706.782932171107;24259.878700606383;25663;26040.869795650902;26106.60840087362 13:53:04 INFO - PROCESS | 1657 | |2;jquery.html;374.47199448777224;376.5048960616789;380.0934770572185;391.26637554585153;397.91643754811486;15312.009438772971;19117.71323430148;20953.895230523845;21029;21059.36821895342;19332;19439.41681749546;19937.305329047012;20781.48046298843;21118.944052797375;5758.539316854642;5791.420857914217;5966.97016514919;6003.159557661931;6106.786262480814;4132.359484279941;5911.793087241947;6009.819705408823;6015.909761353583;6035.5473339499495;4323.956760432403;6262.154609127778;6544.476441884638;6598.637074960875;6680.933190668104;6370.203724534434;6573.506986975996;6622.569532980341;6644.734210631593;6652.767153149616;4879.560839524424;5674.517665998395;5726.141078838166;5760.7695692172265;5771.624844385102;23146.76853231463;24273.271801845975;25409.364765881;25654.615180772304;25971.870140649364;2089.1538926734697;2168.8048075673264;2425.2966639674473;2529.747025297474;2911.5984111359103;9729.56216970238;10075.697729068139;10259.589616415335;10294.17646588271;10313.9484302578;1639.303296099165;1773.3084097202102;1801.1804628893822;1846.8337849593602;1883.1055248756868;121520.39239803833;124739.9999999991;124896.75103249033;127512.72487275102;128265;9159.587818548182;11495;11643.126765492452;11697.707557311136;11807.291562506278;14588.635284117981;14703.852961470247;14716.117032978056;14722.337494812758;14751.852481475262;7970.4819186752675;8278.254957053774;8405.159484051546;8431.030431500334;8542.145785421408;6728.697208625624;8158.632861521246;8466.238038576557;8473.406861519758;8490.490570565786;4464.866054018385;4562.657800664897;4568.70303430276;4639.930401043987;4656;1569.5683686985942;1587.3095203586477;1728.671552405039;1899.154876080131;1921.990954748768;646.3310473659834;666.3669513961755;904.3398319227001;941.651588912107;1006.6124542051363;17985.820141798675;20431.182752690023;20940.057697403652;21201.787982119982;21422.428577819926;888.1562515610196;898.3846065445191;938.3853575907655;954.3844220477753;1008.9859691010488;10471.528781204865;10933.453327333602;11253.774924501628;11270;11271.211015229019;479354;517368;571242;601766;606725;117744;123701.38149309196;128024;140506.297468512;143101;818.7134502924048;972.8686627305365;983.6852207293597;990.6681261777385;995.6764051683232;17894.731579026586;17935.013574253542;17991.68199632105;18039.917604943745;18217.362392316205;49093.509064908896;52818.47181528136;53603.46396535985;55734;56704.14943775929;77610.6119469399;78588.60705696435;78617.66955443633;78777;79894.60052699699;7617.27635874591;7882.881756773539;8004.119546849958;8126.471779334324;8168.22401871845;10554.155667546731;12447.564335248222;12755.55355562588;12870.613881583567;12942.482300708243;7293.708251669874;8412.71413011194;9209.677661281823;10998.285111467729;11232.213745038096;9266.258699303904;11252.774944501229;11302.378369189773;11384.544618215179;11568.710782230175;10914.836277455686;11262.155338349492;11587.768244634892;11607.941960290145;11620.88379116198;6512.571610439196;8202.958985205036;8293.83412331738;8342.416030878023;8543.401961862859;10109.848352274576;11258.268212566158;11470.598529051444;11543.942280288546;11636.650900473 13:53:04 INFO - PROCESS | 1657 | |3;mootools.html;1531.7855500229966;1570.9214539273037;1809.7783995802838;1900.1734245603154;1939.6896496560553;8063.838723225546;8309.667613295462;8521.531315777638;9138.680146194885;9173.541322933852;8553.61508732107;8878.200961913426;8888.022317545065;9020.72937811865;9043.27653787697;2333.8132949364053;2382.106709983756;2383.8569685818907;2384.7972922301624;2403.7836594706473;2348.58899692554;2383.189715496731;2389.23544465771;2395.0898658509827;2397.3287479505766;2376.774206450393;2379.262428647125;2390.2231774673214;2395.173665085543;2395.4969456414174;2343.800776933963;2350;2353.435175557871;2359.374765687094;2375.904963801446;1969.5863868587614;1979.435860779671;2042.5812708394744;2352.3295860679623;2366.93487930432;8975;9034.232090272335;9078.319126065506;9079.092090790935;9092.681756138503;4837.274408838703;5045.798168073273;5069.707224657725;5494.478024587658;5507.421720719307;3168.2871353945407;3433.8111403872776;3439.8280085995602;3563.625819288963;3571.982140089283;917.7338571814232;993.2848349188573;1052.468503405783;1060.3226852198184;1061.4109169410974;11657.591984280509;11910.225835320676;11914.285142891455;11948.940255298754;11949.761004779855;4752.714837109785;4793;4831.879203019882;4920.065187614342;4943.629227807929;10091.44497052669;10260;10265.538050787733;10288.022637849392;10298.639547615798;5520;5529.198266251371;5539.19681646159;5542.722863856791;5567.638103523258;4478.462584489882;4630.3748993886065;4847.491013443609;4979.327790748275;5018.04657115147;3542.964570354315;3957.3272543667645;4010.598940105966;4042.757434553936;4066.6543343815515;1173.6009756682597;1221.419825582841;1288.1047671867962;1297.695041665208;1307.6142537951328;771.6488997506234;904.3307952115388;923.2337160157188;929.4292645429204;946.4605175050293;4990.725510096907;5730.283714535683;5903.793367232212;5965.403459654;6080.695965201722;368.9022409061601;372.8887914016247;421.2228438530906;431.20012377040763;791.746641074862;3823.5220597425323;3846.7307288489537;3925.4700615417123;3950.3481925482547;4134.73124246923;10559.524821383056;10832.945835270773;10875;10885.346879187275;10914.617988370528;8130.471519351223;9305.069493050776;10763.730906727238;10916.672499825017;10935;8246.216609422096;8314.168583141638;8380.036295825936;8381.11998240176;8388.161183881562;5673.149027645886;5767.884642307046;5900.350961394157;5915.438033386993;6059.121427393092;8738.86394768676;9546.61813527479;10077;10091.44497052669;10170;9752.951235243778;10201.948990255001;10201.948990255298;10335.689929302132;10360.326578772356;6974.58152510851;7194.89207661875;7404.629768511661;7612.352949999312;7800.843983120192;8328.042275138436;8638.78403039929;8647.0920553341;8650.697225597325;8657.437266577652;7550.66022029021;7677.155512893689;7679.424043196671;7810.336121429742;7829.804254893673;7365.668544915598;7524.05949256343;7574.848503030019;7630.694772209272;7639;6953.513254072166;7068.858622827617;7082;7084.822879428056;7092.716291348288;4936.7284799336385;5077.060743762416;5095.617828662939;5164.9741751291;5204.219367094966;5046.243063540352;5085.923711144262;5103.234514822806;5140.177571588528;5254.527092561688 13:53:04 INFO - PROCESS | 1657 | |4;prototype.html;301.38968588608066;303.8344102464157;309.51869842395075;316.7545152506808;317.41912300490105;4605.746683932382;5487.722595123019;5543.223948647193;5574.581906357024;5604.355499117602;5166.793328266875;5333.893322133555;5452.6183167178215;5485.725713714308;5504.559635229182;3636.4545318202217;4169.812358443862;4187.644050255732;4196.349565817303;4221.050263690676;3848.9985207691984;4109.219248342805;4135.565765594614;4201.978990105045;4207.284761590522;3560.465930110491;4117.629413352797;4130.607592278729;4134.917301653965;4154.896127596804;3386.9322613547592;3729.9999999999864;4063.9390409143884;4126.442930204444;4128.153728485653;3543.3346327226163;3548.6806187442994;3549.236914063463;3561.305545418644;3578;4436.866893993185;4982.085479994208;5311.229871668586;5319.3616765987945;5360.195970604402;4046.028953051276;4085.795710214507;4659.860204193879;4690.319903613991;4691.718496890164;4772.355731976173;4864.975675121637;4950.529699678525;5742.97128514359;5795.1017592273265;3142.4186525492855;3694.2796154749835;3876.2247550489733;3936.881893543198;4021.8939791557555;5567.610267281292;6080.817575472743;6112.541559383064;6121.296050954108;6192.87614247717;3319.6348401675796;3660.9816950915606;3803.733738638324;3954.7231693781737;3967.5834037425657;3417.5898892133105;3619.638335805348;3880.84476620932;3886.7279290449396;4037.273290807624;4615.353850460938;4665.206914824488;4670.95329046712;4692.512968126898;4706.247000479907;5315.548178404802;5361.758720857571;5855.736491857877;5906.350301466835;5966.49284810796;1219.8292239086536;1282.5190553542423;1322.7817410127413;1336.2049580499588;1362.7615167345675;883.9071897450804;901.7195582273188;913.7395842184945;927.7216834949488;929.6513807322254;5036.798528058836;5375.2854808321545;5455.454454554513;5481.040817856939;5526.806561770319;4860.902781944412;5534.916976245359;5898.911516327258;5999.670018149044;6046.546509011841;4777.971266869795;5425.972870135624;5448.237246785453;5513.8345849624575;5554;2277.055022165816;2326.4532834783813;2392.138830021191;2444.926652200437;2611.791056715458;4714.764261786897;4724.834630787906;4862.41651001882;4943.876403089879;5266.3943646480375;4354.586314300136;4652.13935421948;4741.525847415231;4804.927926081112;5108.3103780989095;4607.456502071709;4621.445426548836;4924.162892308244;5059.56993655536;5107.770150343169;4213.957860421479;4310.806013729327;4453.977730111458;4915.95084049155;5040.765012571944;4369.492525078843;4786.545278198566;4794.664373493962;4853.80584776605;6067.908981365372;5487.6981766003255;6269.5611307208055;6331.96834015827;6334.049892516159;6375.968120159369;3319.6348401675314;3333.383324085052;3479.251960828333;3960.980195099006;3990.822707301411;4705.905881882275;5588.692621905834;5950.7917222896995;6069.635821850703;6081.32080091556;5723.656580605177;5821.825345239649;5872.412758724094;5944.0489521678055;5976.701164941823;5085.186370180753;5896.764129434775;5931.288245410578;5994.910076348945;6052.878942421039;5201.271821944855;5514.531264842373;5688.203651488712;5764.394738552392;5767.365589785037;4982.900341993068;5393.81336106056;5887.970560147171;5890.676012819336;5928.703564821828;4386.363977223221;5531.072938213913;5746.683932383759;5777;5819.301683797971 13:53:04 INFO - PROCESS | 1657 | |5;yui.html;684.6713577482811;721.5346101764362;767.9500832445891;773.211324449062;847.1570787066868;15139.091654500739;16399.4260200893;16453.753193702105;16459.423920162797;16466.752998705015;13140.408681609326;14424.35090420931;14828.925855370735;14919.552413427587;14940.775888361683;677.5121912223192;705.0341032785092;819.2053707903355;875.0461996423912;877.8858748362704;836.7364280251701;898.3262553085186;900.621738869673;901.5221932375852;901.8376692195435;967.8790151231096;969.1568335548083;972.5477652891404;973.2116985241942;976.4531862157214;918.2057520245007;949.1220620925616;956.7464621875208;960.3997501561524;962.5331714118647;701.130598058404;709.3544874164537;711.7188710459392;712.1134187936001;712.6757325416922;15103;15220.086794792347;15225.847741522553;15226.162561059138;15246.771298430533;11613.6515904523;12184.329861857594;14507.057041292283;14656.41374345025;14683.55949321522;10814.405207713573;11276.887231127666;11943.522259109624;11986.400679965967;12054;3784.299904517673;3792.4500947362476;3831.9042023949623;3887.1836914248042;3892.961070389288;116837.41581292039;121537;123820.38089809583;125089.37455312756;125573;11120;11265.831012534818;11284.323732231258;11303.886961130447;11411.771764564663;23459.530809383716;23484;23488.765112349;23574.88212558926;23590.17434389788;7816.53100813953;7865;7924.960375198087;8100.594970251464;8198.139195384518;4456.9331460028125;4459.1973444779605;4506.258141527608;4513.390692256503;4578.862634120982;3612.837422316002;3729;3732.570754363283;3737.0844143185095;3747.213085252073;649.4706813946618;659.1661548141604;674.3425160468602;675.972961081561;688.0298778721977;544.1647071744852;579.7536047180016;666.7899611622323;669.1602039440568;675.6183604528751;6982.546134501343;7219.963900180465;9048.50233237165;9376.203022743006;9523.238140948708;566.8044524638993;656.2715385921623;675.2909445082644;677.5697432130632;677.9796606101825;4198.160367926427;4608.354830323758;4641.767911604474;4685.508021657745;4737.265723812815;109572.4521377404;163829;169514;170082;173194;145256.27371863072;146980;147774.56676299727;148172;150657;79358.6032069836;85939;97550;98345;105467;9588.328816982745;9776.315657904162;9902;9926.255530835071;10005;57531.712341438026;57755.71122144363;58267.4173258262;59163.40836591579;59886.92091963001;74080;92415.53792230996;93741.56325930699;96908.51545742227;99388.50305748425;12862.935685321514;12952.611421657366;13066;13068.869311306766;13201.20792752438;14435.133891966516;14527.273636318354;14673.192974386084;14716.852831471548;15280.541583752505;13497.730045399234;13678.589642310746;13752.518661846787;13826.930865346012;13833.79249311241;13257.66855828612;13442.39509222107;13494.595162145151;13838.723225535634;14290.285485725464;13422.865771342553;13549.25479098659;13556;13560.11859229147;13572.253526055767;10986.890131098906;11181.944090279821;11379.601713939972;11404.828927565926;11457.942710286396;9784.60861565558;10132.287899065132;10380.740481488023;10420.32267902584;11562.537498500302 13:53:04 INFO - PROCESS | 1657 | __end_tp_report 13:53:04 INFO - PROCESS | 1657 | __start_cc_report 13:53:04 INFO - PROCESS | 1657 | _x_x_mozilla_cycle_collect,366 13:53:04 INFO - PROCESS | 1657 | __end_cc_report 13:53:04 INFO - PROCESS | 1657 | __startTimestamp1476910384482__endTimestamp 13:53:04 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | ------- Summary: start ------- 13:53:04 INFO - PROCESS | 1657 | Number of tests: 6 13:53:04 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | [#0] dojo.html Cycles:165 Average:5749.61 Median:5993.37 stddev:652.15 (10.9%) stddev-sans-first:627.04 13:53:04 INFO - PROCESS | 1657 | Values: 3377.6 3403.2 3429.7 3435.4 3450.1 4280.3 5473.0 5657.2 5698.9 5708.2 4826.4 5650.9 5787.3 5793.0 5799.9 5233.8 5303.8 5306.9 5390.0 5390.7 5344.5 5357.6 5365.0 5373.3 5400.6 5352.9 5354.4 5356.4 5358.7 5382.5 5330.6 5342.0 5342.8 5352.0 5356.9 5174.9 5260.3 5297.3 5315.7 5335.5 5755.1 5782.7 5875.7 5893.4 5947.1 6086.7 6194.7 6228.0 6237.8 6262.8 6148.7 6178.4 6180.8 6198.1 6255.8 5936.4 5937.7 5957.4 5968.6 5993.4 6365.7 6372.1 6382.9 6383.6 6404.8 5986.8 6109.0 6119.8 6120.0 6204.8 6104.3 6207.6 6215.1 6218.2 6230.0 6189.7 6211.4 6215.3 6216.1 6245.5 6063.1 6122.8 6189.2 6206.8 6222.8 4939.3 4952.4 4969.0 4987.3 5019.5 4409.0 4416.7 4436.5 4444.7 4476.2 5741.1 5841.9 5932.6 5957.2 5968.9 4841.5 5149.9 5584.8 5760.7 6160.6 4927.7 5625.1 5920.1 5923.9 5967.3 4529.8 5288.5 5334.4 5426.8 5431.3 6221.7 6454.1 6456.5 6482.5 6482.6 5223.4 6109.9 6121.5 6148.7 6251.4 6422.2 6447.1 6448.4 6482.2 6489.8 6209.6 6219.9 6241.6 6259.7 6270.2 6107.1 6121.9 6147.5 6149.7 6178.9 6151.8 6152.7 6153.1 6162.8 6185.6 6048.8 6122.5 6145.4 6173.0 6178.2 5814.5 5981.2 6019.7 6023.5 6032.5 6159.9 6165.2 6189.6 6212.6 6237.6 6032.9 6071.7 6084.3 6087.6 6108.8 13:53:04 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | [#1] ext.html Cycles:180 Average:69242.38 Median:40364.50 stddev:149658.18 (370.8%) stddev-sans-first:149988.93 13:53:04 INFO - PROCESS | 1657 | Values: 466.8 500.7 524.8 529.5 559.8 37572.0 40860.2 41123.4 43107.8 43248.4 39467.8 42238.9 42395.0 42786.8 43545.8 8849.8 9633.9 9636.3 9646.0 9666.7 9523.2 9574.8 9582.6 9589.8 9616.1 9546.7 9587.0 9632.3 9639.0 9643.1 9441.8 9566.0 9596.7 9609.8 9614.3 9537.2 9605.3 9622.4 9646.6 9654.0 40174.0 40264.2 40464.8 40527.0 40602.4 3339.3 3345.8 3392.1 3392.8 3495.8 30209.8 30274.2 30901.7 31223.7 31691.2 3168.4 3173.7 3189.1 3282.3 3327.7 486662.0 487399.0 489864.0 490657.5 495319.0 61173.8 61246.9 61483.7 61556.1 61698.8 55773.3 64339.7 64586.7 64741.0 64808.4 14144.5 15523.0 15762.4 15801.2 15852.0 12486.9 12566.1 12569.2 12587.6 12603.0 15529.5 17625.5 19045.0 19204.4 19249.3 3295.3 7806.8 8151.4 8226.6 8254.3 859.7 947.8 1002.3 1024.3 1065.3 28421.4 28855.9 30069.5 30310.2 30757.1 1036.5 1102.7 1119.7 1129.1 1136.8 15316.5 15735.3 15758.8 15905.4 16176.0 573701.0 647755.0 653446.0 656723.7 658110.0 57941.1 58371.8 58489.7 58671.7 58676.7 1330.7 1359.0 1369.8 1384.7 1390.1 29269.6 30030.4 30185.4 30495.5 30749.7 50394.7 50511.2 50649.0 50666.7 50718.0 498274.0 503038.0 503065.0 595062.0 601099.0 26335.9 26519.5 26773.1 26866.0 26892.7 46505.0 46545.5 48176.5 48548.8 48627.0 38587.4 39081.8 39487.0 40606.6 41067.8 33257.2 38055.5 38825.0 39465.2 39808.8 38084.6 38108.2 38620.0 38997.0 39016.2 30877.8 34445.3 34923.5 35396.5 35468.0 21706.8 24259.9 25663.0 26040.9 26106.6 13:53:04 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | [#2] jquery.html Cycles:180 Average:34015.72 Median:1643.04 stddev:93790.35 (5708.4%) stddev-sans-first:94019.44 13:53:04 INFO - PROCESS | 1657 | Values: 374.5 376.5 380.1 391.3 397.9 15312.0 19117.7 20953.9 21029.0 21059.4 19332.0 19439.4 19937.3 20781.5 21118.9 5758.5 5791.4 5967.0 6003.2 6106.8 4132.4 5911.8 6009.8 6015.9 6035.5 4324.0 6262.2 6544.5 6598.6 6680.9 6370.2 6573.5 6622.6 6644.7 6652.8 4879.6 5674.5 5726.1 5760.8 5771.6 23146.8 24273.3 25409.4 25654.6 25971.9 2089.2 2168.8 2425.3 2529.7 2911.6 9729.6 10075.7 10259.6 10294.2 10313.9 1639.3 1773.3 1801.2 1846.8 1883.1 121520.4 124740.0 124896.8 127512.7 128265.0 9159.6 11495.0 11643.1 11697.7 11807.3 14588.6 14703.9 14716.1 14722.3 14751.9 7970.5 8278.3 8405.2 8431.0 8542.1 6728.7 8158.6 8466.2 8473.4 8490.5 4464.9 4562.7 4568.7 4639.9 4656.0 1569.6 1587.3 1728.7 1899.2 1922.0 646.3 666.4 904.3 941.7 1006.6 17985.8 20431.2 20940.1 21201.8 21422.4 888.2 898.4 938.4 954.4 1009.0 10471.5 10933.5 11253.8 11270.0 11271.2 479354.0 517368.0 571242.0 601766.0 606725.0 117744.0 123701.4 128024.0 140506.3 143101.0 818.7 972.9 983.7 990.7 995.7 17894.7 17935.0 17991.7 18039.9 18217.4 49093.5 52818.5 53603.5 55734.0 56704.1 77610.6 78588.6 78617.7 78777.0 79894.6 7617.3 7882.9 8004.1 8126.5 8168.2 10554.2 12447.6 12755.6 12870.6 12942.5 7293.7 8412.7 9209.7 10998.3 11232.2 9266.3 11252.8 11302.4 11384.5 11568.7 10914.8 11262.2 11587.8 11607.9 11620.9 6512.6 8203.0 8293.8 8342.4 8543.4 10109.8 11258.3 11470.6 11543.9 11636.7 13:53:04 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | [#3] mootools.html Cycles:180 Average:5738.08 Median:4940.18 stddev:3249.24 (65.8%) stddev-sans-first:3242.98 13:53:04 INFO - PROCESS | 1657 | Values: 1531.8 1570.9 1809.8 1900.2 1939.7 8063.8 8309.7 8521.5 9138.7 9173.5 8553.6 8878.2 8888.0 9020.7 9043.3 2333.8 2382.1 2383.9 2384.8 2403.8 2348.6 2383.2 2389.2 2395.1 2397.3 2376.8 2379.3 2390.2 2395.2 2395.5 2343.8 2350.0 2353.4 2359.4 2375.9 1969.6 1979.4 2042.6 2352.3 2366.9 8975.0 9034.2 9078.3 9079.1 9092.7 4837.3 5045.8 5069.7 5494.5 5507.4 3168.3 3433.8 3439.8 3563.6 3572.0 917.7 993.3 1052.5 1060.3 1061.4 11657.6 11910.2 11914.3 11948.9 11949.8 4752.7 4793.0 4831.9 4920.1 4943.6 10091.4 10260.0 10265.5 10288.0 10298.6 5520.0 5529.2 5539.2 5542.7 5567.6 4478.5 4630.4 4847.5 4979.3 5018.0 3543.0 3957.3 4010.6 4042.8 4066.7 1173.6 1221.4 1288.1 1297.7 1307.6 771.6 904.3 923.2 929.4 946.5 4990.7 5730.3 5903.8 5965.4 6080.7 368.9 372.9 421.2 431.2 791.7 3823.5 3846.7 3925.5 3950.3 4134.7 10559.5 10832.9 10875.0 10885.3 10914.6 8130.5 9305.1 10763.7 10916.7 10935.0 8246.2 8314.2 8380.0 8381.1 8388.2 5673.1 5767.9 5900.4 5915.4 6059.1 8738.9 9546.6 10077.0 10091.4 10170.0 9753.0 10201.9 10201.9 10335.7 10360.3 6974.6 7194.9 7404.6 7612.4 7800.8 8328.0 8638.8 8647.1 8650.7 8657.4 7550.7 7677.2 7679.4 7810.3 7829.8 7365.7 7524.1 7574.8 7630.7 7639.0 6953.5 7068.9 7082.0 7084.8 7092.7 4936.7 5077.1 5095.6 5165.0 5204.2 5046.2 5085.9 5103.2 5140.2 5254.5 13:53:04 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | [#4] prototype.html Cycles:180 Average:4497.39 Median:4857.35 stddev:1427.97 (29.4%) stddev-sans-first:1396.81 13:53:04 INFO - PROCESS | 1657 | Values: 301.4 303.8 309.5 316.8 317.4 4605.7 5487.7 5543.2 5574.6 5604.4 5166.8 5333.9 5452.6 5485.7 5504.6 3636.5 4169.8 4187.6 4196.3 4221.1 3849.0 4109.2 4135.6 4202.0 4207.3 3560.5 4117.6 4130.6 4134.9 4154.9 3386.9 3730.0 4063.9 4126.4 4128.2 3543.3 3548.7 3549.2 3561.3 3578.0 4436.9 4982.1 5311.2 5319.4 5360.2 4046.0 4085.8 4659.9 4690.3 4691.7 4772.4 4865.0 4950.5 5743.0 5795.1 3142.4 3694.3 3876.2 3936.9 4021.9 5567.6 6080.8 6112.5 6121.3 6192.9 3319.6 3661.0 3803.7 3954.7 3967.6 3417.6 3619.6 3880.8 3886.7 4037.3 4615.4 4665.2 4671.0 4692.5 4706.2 5315.5 5361.8 5855.7 5906.4 5966.5 1219.8 1282.5 1322.8 1336.2 1362.8 883.9 901.7 913.7 927.7 929.7 5036.8 5375.3 5455.5 5481.0 5526.8 4860.9 5534.9 5898.9 5999.7 6046.5 4778.0 5426.0 5448.2 5513.8 5554.0 2277.1 2326.5 2392.1 2444.9 2611.8 4714.8 4724.8 4862.4 4943.9 5266.4 4354.6 4652.1 4741.5 4804.9 5108.3 4607.5 4621.4 4924.2 5059.6 5107.8 4214.0 4310.8 4454.0 4916.0 5040.8 4369.5 4786.5 4794.7 4853.8 6067.9 5487.7 6269.6 6332.0 6334.0 6376.0 3319.6 3333.4 3479.3 3961.0 3990.8 4705.9 5588.7 5950.8 6069.6 6081.3 5723.7 5821.8 5872.4 5944.0 5976.7 5085.2 5896.8 5931.3 5994.9 6052.9 5201.3 5514.5 5688.2 5764.4 5767.4 4982.9 5393.8 5888.0 5890.7 5928.7 4386.4 5531.1 5746.7 5777.0 5819.3 13:53:04 INFO - PROCESS | 1657 | 13:53:04 INFO - PROCESS | 1657 | [#5] yui.html Cycles:180 Average:25467.22 Median:3765.76 stddev:41836.04 (1111.0%) stddev-sans-first:41912.02 13:53:04 INFO - PROCESS | 1657 | Values: 684.7 721.5 768.0 773.2 847.2 15139.1 16399.4 16453.8 16459.4 16466.8 13140.4 14424.4 14828.9 14919.6 14940.8 677.5 705.0 819.2 875.0 877.9 836.7 898.3 900.6 901.5 901.8 967.9 969.2 972.5 973.2 976.5 918.2 949.1 956.7 960.4 962.5 701.1 709.4 711.7 712.1 712.7 15103.0 15220.1 15225.8 15226.2 15246.8 11613.7 12184.3 14507.1 14656.4 14683.6 10814.4 11276.9 11943.5 11986.4 12054.0 3784.3 3792.5 3831.9 3887.2 3893.0 116837.4 121537.0 123820.4 125089.4 125573.0 11120.0 11265.8 11284.3 11303.9 11411.8 23459.5 23484.0 23488.8 23574.9 23590.2 7816.5 7865.0 7925.0 8100.6 8198.1 4456.9 4459.2 4506.3 4513.4 4578.9 3612.8 3729.0 3732.6 3737.1 3747.2 649.5 659.2 674.3 676.0 688.0 544.2 579.8 666.8 669.2 675.6 6982.5 7220.0 9048.5 9376.2 9523.2 566.8 656.3 675.3 677.6 678.0 4198.2 4608.4 4641.8 4685.5 4737.3 109572.5 163829.0 169514.0 170082.0 173194.0 145256.3 146980.0 147774.6 148172.0 150657.0 79358.6 85939.0 97550.0 98345.0 105467.0 9588.3 9776.3 9902.0 9926.3 10005.0 57531.7 57755.7 58267.4 59163.4 59886.9 74080.0 92415.5 93741.6 96908.5 99388.5 12862.9 12952.6 13066.0 13068.9 13201.2 14435.1 14527.3 14673.2 14716.9 15280.5 13497.7 13678.6 13752.5 13826.9 13833.8 13257.7 13442.4 13494.6 13838.7 14290.3 13422.9 13549.3 13556.0 13560.1 13572.3 10986.9 11181.9 11379.6 11404.8 11457.9 9784.6 10132.3 10380.7 10420.3 11562.5 13:53:04 INFO - PROCESS | 1657 | -------- Summary: end -------- 13:53:04 INFO - PROCESS | 1657 | 13:53:05 INFO - TEST-INFO | 1657: exit 0 13:53:05 INFO - TEST-OK | dromaeo_css | took 1116135ms 13:53:05 INFO - TEST-START | kraken 13:53:05 INFO - operating with platform_type : mac_ 13:53:05 INFO - Initialising browser for kraken test... 13:53:05 INFO - TEST-INFO | started process 1665 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/tmp255x_h/profile http://localhost:49273/getInfo.html) 13:53:07 INFO - PROCESS | 1665 | 2016-10-19 13:53:07.899 plugin-container[1666:10058] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x873f, name = 'com.apple.tsm.portname' 13:53:07 INFO - PROCESS | 1665 | See /usr/include/servers/bootstrap_defs.h for the error codes. 13:53:07 INFO - PROCESS | 1665 | 2016-10-19 13:53:07.903 plugin-container[1666:10058] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x441f, name = 'com.apple.CFPasteboardClient' 13:53:07 INFO - PROCESS | 1665 | See /usr/include/servers/bootstrap_defs.h for the error codes. 13:53:07 INFO - PROCESS | 1665 | 2016-10-19 13:53:07.904 plugin-container[1666:10058] Failed to allocate communication port for com.apple.CFPasteboardClient; this is likely due to sandbox restrictions 13:53:07 INFO - PROCESS | 1665 | __metrics Screen width/height:1600/1200 13:53:07 INFO - PROCESS | 1665 | colorDepth:24 13:53:07 INFO - PROCESS | 1665 | Browser inner width/height: 1024/689 13:53:07 INFO - PROCESS | 1665 | __metrics 13:53:08 ERROR - PROCESS | 1665 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3097: TypeError: this.tabs is undefined 13:53:08 INFO - TEST-INFO | 1665: exit 0 13:53:08 INFO - Browser initialized. 13:53:08 INFO - Running cycle 1/1 for kraken test... 13:53:08 INFO - TEST-INFO | started process 1667 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/tmp255x_h/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:53:11 INFO - PROCESS | 1667 | 2016-10-19 13:53:11.337 plugin-container[1668:10174] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x443b, name = 'com.apple.tsm.portname' 13:53:11 INFO - PROCESS | 1667 | See /usr/include/servers/bootstrap_defs.h for the error codes. 13:53:11 INFO - PROCESS | 1667 | 2016-10-19 13:53:11.339 plugin-container[1668:10174] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x8f0b, name = 'com.apple.CFPasteboardClient' 13:53:11 INFO - PROCESS | 1667 | See /usr/include/servers/bootstrap_defs.h for the error codes. 13:53:11 INFO - PROCESS | 1667 | 2016-10-19 13:53:11.339 plugin-container[1668:10174] Failed to allocate communication port for com.apple.CFPasteboardClient; this is likely due to sandbox restrictions 13:53:21 INFO - PROCESS | 1667 | RSS: Main: 237178880 13:53:21 INFO - PROCESS | 1667 | 13:53:24 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49273/tests/kraken/driver.html?testName=audio-beat-detection) 13:53:25 INFO - PROCESS | 1667 | RSS: Main: 249507840 13:53:25 INFO - PROCESS | 1667 | 13:53:27 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49273/tests/kraken/driver.html?testName=audio-dft) 13:53:28 INFO - PROCESS | 1667 | RSS: Main: 257060864 13:53:28 INFO - PROCESS | 1667 | 13:53:31 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49273/tests/kraken/driver.html?testName=audio-fft) 13:53:32 INFO - PROCESS | 1667 | RSS: Main: 260018176 13:53:32 INFO - PROCESS | 1667 | 13:53:34 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49273/tests/kraken/driver.html?testName=audio-oscillator) 13:53:34 INFO - PROCESS | 1667 | RSS: Main: 261210112 13:53:34 INFO - PROCESS | 1667 | 13:53:36 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49273/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:53:37 INFO - PROCESS | 1667 | RSS: Main: 261967872 13:53:37 INFO - PROCESS | 1667 | 13:53:40 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49273/tests/kraken/driver.html?testName=imaging-darkroom) 13:53:41 INFO - PROCESS | 1667 | RSS: Main: 261873664 13:53:41 INFO - PROCESS | 1667 | 13:53:44 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49273/tests/kraken/driver.html?testName=imaging-desaturate) 13:53:44 INFO - PROCESS | 1667 | RSS: Main: 263319552 13:53:44 INFO - PROCESS | 1667 | 13:53:47 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49273/tests/kraken/driver.html?testName=json-parse-financial) 13:53:48 INFO - PROCESS | 1667 | RSS: Main: 263352320 13:53:48 INFO - PROCESS | 1667 | 13:53:49 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49273/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:53:50 INFO - PROCESS | 1667 | RSS: Main: 263204864 13:53:50 INFO - PROCESS | 1667 | 13:53:52 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49273/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:53:53 INFO - PROCESS | 1667 | RSS: Main: 263274496 13:53:53 INFO - PROCESS | 1667 | 13:53:55 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49273/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:53:56 INFO - PROCESS | 1667 | RSS: Main: 263315456 13:53:56 INFO - PROCESS | 1667 | 13:53:59 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49273/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:54:00 INFO - PROCESS | 1667 | RSS: Main: 263798784 13:54:00 INFO - PROCESS | 1667 | 13:54:02 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49273/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:54:03 INFO - PROCESS | 1667 | RSS: Main: 263557120 13:54:03 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | Cycle 1(1): loaded http://localhost:49273/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49273/tests/kraken/driver.html?testName=ai-astar) 13:54:05 INFO - PROCESS | 1667 | RSS: Main: 264962048 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | __start_tp_report 13:54:05 INFO - PROCESS | 1667 | _x_x_mozilla_page_load 13:54:05 INFO - PROCESS | 1667 | _x_x_mozilla_page_load_details 13:54:05 INFO - PROCESS | 1667 | |i|pagename|runs| 13:54:05 INFO - PROCESS | 1667 | |0;ai-astar;106;118;113;154;173;170;117;118;118;119 13:54:05 INFO - PROCESS | 1667 | |1;audio-beat-detection;169;101;98;131;133;105;99;100;116;100 13:54:05 INFO - PROCESS | 1667 | |2;audio-dft;194;213;231;197;194;202;200;222;258;195 13:54:05 INFO - PROCESS | 1667 | |3;audio-fft;77;58;58;84;59;60;66;80;99;58 13:54:05 INFO - PROCESS | 1667 | |4;audio-oscillator;82;68;86;73;68;94;124;97;100;97 13:54:05 INFO - PROCESS | 1667 | |5;imaging-gaussian-blur;90;123;79;132;136;86;94;121;90;88 13:54:05 INFO - PROCESS | 1667 | |6;imaging-darkroom;97;96;152;98;96;96;96;100;151;127 13:54:05 INFO - PROCESS | 1667 | |7;imaging-desaturate;87;120;138;109;91;87;89;139;94;140 13:54:05 INFO - PROCESS | 1667 | |8;json-parse-financial;58;57;58;58;57;59;58;58;59;60 13:54:05 INFO - PROCESS | 1667 | |9;json-stringify-tinderbox;67;76;68;81;80;74;67;68;89;62 13:54:05 INFO - PROCESS | 1667 | |10;stanford-crypto-aes;105;76;101;104;110;88;89;98;114;114 13:54:05 INFO - PROCESS | 1667 | |11;stanford-crypto-ccm;175;162;162;142;159;147;153;147;211;170 13:54:05 INFO - PROCESS | 1667 | |12;stanford-crypto-pbkdf2;176;176;177;175;172;177;175;182;174;172 13:54:05 INFO - PROCESS | 1667 | |13;stanford-crypto-sha256-iterative;72;69;68;69;72;73;68;72;70;69 13:54:05 INFO - PROCESS | 1667 | __end_tp_report 13:54:05 INFO - PROCESS | 1667 | __start_cc_report 13:54:05 INFO - PROCESS | 1667 | _x_x_mozilla_cycle_collect,977 13:54:05 INFO - PROCESS | 1667 | __end_cc_report 13:54:05 INFO - PROCESS | 1667 | __startTimestamp1476910445591__endTimestamp 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | ------- Summary: start ------- 13:54:05 INFO - PROCESS | 1667 | Number of tests: 14 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#0] ai-astar Cycles:10 Average:130.60 Median:118.50 stddev:24.96 (21.1%) stddev-sans-first:24.84 13:54:05 INFO - PROCESS | 1667 | Values: 106.0 118.0 113.0 154.0 173.0 170.0 117.0 118.0 118.0 119.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#1] audio-beat-detection Cycles:10 Average:115.20 Median:132.00 stddev:23.06 (17.5%) stddev-sans-first:14.02 13:54:05 INFO - PROCESS | 1667 | Values: 169.0 101.0 98.0 131.0 133.0 105.0 99.0 100.0 116.0 100.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#2] audio-dft Cycles:10 Average:210.60 Median:207.50 stddev:20.99 (10.1%) stddev-sans-first:21.38 13:54:05 INFO - PROCESS | 1667 | Values: 194.0 213.0 231.0 197.0 194.0 202.0 200.0 222.0 258.0 195.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#3] audio-fft Cycles:10 Average:69.90 Median:71.50 stddev:14.36 (20.1%) stddev-sans-first:15.00 13:54:05 INFO - PROCESS | 1667 | Values: 77.0 58.0 58.0 84.0 59.0 60.0 66.0 80.0 99.0 58.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#4] audio-oscillator Cycles:10 Average:88.90 Median:84.00 stddev:17.30 (20.6%) stddev-sans-first:18.17 13:54:05 INFO - PROCESS | 1667 | Values: 82.0 68.0 86.0 73.0 68.0 94.0 124.0 97.0 100.0 97.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#5] imaging-gaussian-blur Cycles:10 Average:103.90 Median:87.00 stddev:21.49 (24.7%) stddev-sans-first:22.19 13:54:05 INFO - PROCESS | 1667 | Values: 90.0 123.0 79.0 132.0 136.0 86.0 94.0 121.0 90.0 88.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#6] imaging-darkroom Cycles:10 Average:110.90 Median:96.00 stddev:23.39 (24.4%) stddev-sans-first:24.26 13:54:05 INFO - PROCESS | 1667 | Values: 97.0 96.0 152.0 98.0 96.0 96.0 96.0 100.0 151.0 127.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#7] imaging-desaturate Cycles:10 Average:109.40 Median:87.00 stddev:22.95 (26.4%) stddev-sans-first:22.86 13:54:05 INFO - PROCESS | 1667 | Values: 87.0 120.0 138.0 109.0 91.0 87.0 89.0 139.0 94.0 140.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#8] json-parse-financial Cycles:10 Average:58.20 Median:58.00 stddev:0.92 (1.6%) stddev-sans-first:0.97 13:54:05 INFO - PROCESS | 1667 | Values: 58.0 57.0 58.0 58.0 57.0 59.0 58.0 58.0 59.0 60.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#9] json-stringify-tinderbox Cycles:10 Average:73.20 Median:75.00 stddev:8.31 (11.1%) stddev-sans-first:8.51 13:54:05 INFO - PROCESS | 1667 | Values: 67.0 76.0 68.0 81.0 80.0 74.0 67.0 68.0 89.0 62.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#10] stanford-crypto-aes Cycles:10 Average:99.90 Median:95.00 stddev:12.38 (13.0%) stddev-sans-first:12.99 13:54:05 INFO - PROCESS | 1667 | Values: 105.0 76.0 101.0 104.0 110.0 88.0 89.0 98.0 114.0 114.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#11] stanford-crypto-ccm Cycles:10 Average:162.80 Median:162.00 stddev:19.91 (12.3%) stddev-sans-first:20.62 13:54:05 INFO - PROCESS | 1667 | Values: 175.0 162.0 162.0 142.0 159.0 147.0 153.0 147.0 211.0 170.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:175.60 Median:176.00 stddev:2.88 (1.6%) stddev-sans-first:3.05 13:54:05 INFO - PROCESS | 1667 | Values: 176.0 176.0 177.0 175.0 172.0 177.0 175.0 182.0 174.0 172.0 13:54:05 INFO - PROCESS | 1667 | 13:54:05 INFO - PROCESS | 1667 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.20 Median:71.00 stddev:1.87 (2.6%) stddev-sans-first:1.87 13:54:05 INFO - PROCESS | 1667 | Values: 72.0 69.0 68.0 69.0 72.0 73.0 68.0 72.0 70.0 69.0 13:54:05 INFO - PROCESS | 1667 | -------- Summary: end -------- 13:54:05 INFO - PROCESS | 1667 | 13:54:06 INFO - TEST-INFO | 1667: exit 0 13:54:06 INFO - TEST-OK | kraken | took 61329ms 13:54:06 INFO - SUITE-END | took 1177s 13:54:06 INFO - Completed test suite (00:19:37) 13:54:06 INFO - javascript benchmark 13:54:06 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7338.066614916227, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3377.594688637364, 3403.2172600301933, 3429.7084747796434, 3435.433153529668, 3450.08572728227, 4280.3151495760685, 5472.960137573863, 5657.207990881269, 5698.914516282254, 5708.200851880735, 4826.444958829736, 5650.915236271459, 5787.334456537489, 5793.0, 5799.855003624912, 5233.764480598373, 5303.761330740107, 5306.893862122755, 5390.0, 5390.73046347683, 5344.545713614348, 5357.624966252364, 5365.0, 5373.328333958255, 5400.567954563645, 5352.866178345534, 5354.437784032679, 5356.437574054727, 5358.65168764031, 5382.4886635769535, 5330.626856120092, 5342.038433082043, 5342.759575819097, 5352.0, 5356.892862142774, 5174.870628234325, 5260.289860868772, 5297.337832770903, 5315.681059136464, 5335.493128152819, 5755.107958266433, 5782.710864456761, 5875.706214689249, 5893.410658934115, 5947.078202878561, 6086.726097325587, 6194.721237544276, 6227.968860155715, 6237.844053898643, 6262.843428914268, 6148.739508400812, 6178.443940045373, 6180.84547886302, 6198.132261483396, 6255.78104766331, 5936.436038576328, 5937.732802023919, 5957.4042595740075, 5968.582199246098, 5993.370696076936, 6365.681715914186, 6372.107904893319, 6382.904256436157, 6383.585066970632, 6404.839879003062, 5986.790462333797, 6108.969455152695, 6119.755209791648, 6120.0, 6204.844878877974, 6104.26748790148, 6207.6275423474735, 6215.12988181655, 6218.22272215973, 6229.968850155811, 6189.659568723673, 6211.378862113753, 6215.34738852414, 6216.098665693449, 6245.469135123474, 6063.120847477179, 6122.794608434074, 6189.226346706661, 6206.844828879314, 6222.782202622977, 4939.3084968104495, 4952.430470495867, 4969.0, 4987.276844857475, 5019.548240658358, 4408.9859332353735, 4416.734995900256, 4436.534163912807, 4444.711093778894, 4476.239039363316, 5741.1388291756575, 5841.912371314434, 5932.584719069624, 5957.165996760457, 5968.910466343008, 4841.467438581753, 5149.897002059938, 5584.771350302927, 5760.711964401763, 6160.630362178284, 4927.728974906343, 5625.128105143709, 5920.082387229986, 5923.940760592425, 5967.343592204854, 4529.818807247739, 5288.524032837063, 5334.386545547234, 5426.75579598919, 5431.2667789847865, 6221.688915554295, 6454.096426500294, 6456.451201647818, 6482.546221764431, 6482.643454610042, 5223.425423203368, 6109.860177052684, 6121.510279177566, 6148.661823599745, 6251.437370636664, 6422.165118534561, 6447.097406363019, 6448.355164483514, 6482.189726284215, 6489.837754056186, 6209.59637623553, 6219.875602488016, 6241.563090583615, 6259.718312675849, 6270.2475702915945, 6107.083937409247, 6121.908171377344, 6147.493864003348, 6149.708561202197, 6178.907316390168, 6151.84620384494, 6152.661603611844, 6153.107799369156, 6162.845928851814, 6185.628862268279, 6048.788292409745, 6122.479589234965, 6145.446909778141, 6173.043178307369, 6178.165947597017, 5814.476697097281, 5981.222441082631, 6019.729112189874, 6023.548233882389, 6032.517398608013, 6159.860425821237, 6165.229346331708, 6189.597676151036, 6212.596181248205, 6237.563370564017, 6032.90950635732, 6071.726772295169, 6084.269887613515, 6087.564275373243, 6108.827782940854], "value": 5709.686726854939, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [466.7619514047835, 500.68206688752633, 524.7874610782633, 529.5181384939704, 559.8264537993223, 37572.0, 40860.182796344096, 41123.383149252746, 43107.78446107765, 43248.35127473083, 39467.80266098673, 42238.94402639935, 42395.0, 42786.786066069704, 43545.78227108868, 8849.823003539941, 9633.855492167622, 9636.277279204052, 9646.0, 9666.661666841663, 9523.238140948708, 9574.760630984212, 9582.616695332179, 9589.760255993586, 9616.134547890688, 9546.665866694668, 9586.952065239664, 9632.277579181555, 9638.987906269846, 9643.083907028857, 9441.81116377672, 9566.0, 9596.712098636983, 9609.759756006086, 9614.326997110205, 9537.1893389062, 9605.327627066108, 9622.37454565451, 9646.565904534313, 9654.0, 40173.995650108984, 40264.194716105805, 40464.79767601172, 40527.0, 40602.390964135564, 3339.282054358325, 3345.832708364572, 3392.112664818192, 3392.7794693344854, 3495.755297129202, 30209.848950755324, 30274.243143921358, 30901.690983090106, 31223.687763122307, 31691.20771980696, 3168.429682657121, 3173.730232930204, 3189.122991177445, 3282.3107147499054, 3327.73378129749, 486662.0, 487399.0, 489864.0, 490657.54671226774, 495319.0, 61173.77652447015, 61246.85636002719, 61483.69258153681, 61556.076658849255, 61698.76602467926, 55773.32680019606, 64339.71320573562, 64586.70826583536, 64741.0, 64808.35191648117, 14144.504942326968, 15522.991005584601, 15762.369505219893, 15801.209939502978, 15852.0, 12486.875131248753, 12566.120371573903, 12569.183003104768, 12587.559435419716, 12602.991760659126, 15529.534113976599, 17625.532197661996, 19045.0, 19204.423867283724, 19249.32627358036, 3295.3244584860527, 7806.765797026098, 8151.388645851584, 8226.629801658939, 8254.339652827759, 859.7291853066264, 947.7535840681335, 1002.3134153105146, 1024.2676486312323, 1065.2969040433277, 28421.431571368455, 28855.855720721684, 30069.548956765666, 30310.242243944078, 30757.077287681404, 1036.486938965217, 1102.6691992402248, 1119.652907598647, 1129.13056946151, 1136.8237923121928, 15316.463923762614, 15735.291911863993, 15758.76361854573, 15905.443309484113, 16176.0, 573701.0, 647755.0, 653446.0, 656723.716381415, 658110.0, 57941.130883036785, 58371.83256334849, 58489.70755146197, 58671.706641467375, 58676.7066164675, 1330.7205486847677, 1359.0, 1369.7739872920856, 1384.7092110656674, 1390.0547627613118, 29269.560956585243, 30030.399392012474, 30185.396292074474, 30495.54256686107, 30749.692503074682, 50394.74802625964, 50511.24233136432, 50649.0, 50666.74666626643, 50718.0, 498274.0, 503038.0, 503065.0, 595062.0, 601099.0, 26335.893128550055, 26519.469610607295, 26773.06294279769, 26866.0, 26892.73107268902, 46505.0, 46545.53454465547, 48176.5182348172, 48548.757256213496, 48627.0, 38587.421188681634, 39081.80459097686, 39487.0, 40606.57876974292, 41067.76796696104, 33257.16857078592, 38055.477780888454, 38825.0, 39465.210695786496, 39808.80095599504, 38084.619153808104, 38108.23783524259, 38620.0, 38997.0, 39016.21967560576, 30877.8456107718, 34445.31109377849, 34923.47614785831, 35396.46905296371, 35468.0, 21706.782932171107, 24259.878700606383, 25663.0, 26040.869795650902, 26106.60840087362], "value": 19946.20479460404, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [374.47199448777224, 376.5048960616789, 380.0934770572185, 391.26637554585153, 397.91643754811486, 15312.009438772971, 19117.71323430148, 20953.895230523845, 21029.0, 21059.36821895342, 19332.0, 19439.41681749546, 19937.305329047012, 20781.48046298843, 21118.944052797375, 5758.539316854642, 5791.420857914217, 5966.97016514919, 6003.159557661931, 6106.786262480814, 4132.359484279941, 5911.793087241947, 6009.819705408823, 6015.909761353583, 6035.5473339499495, 4323.956760432403, 6262.154609127778, 6544.476441884638, 6598.637074960875, 6680.933190668104, 6370.203724534434, 6573.506986975996, 6622.569532980341, 6644.734210631593, 6652.767153149616, 4879.560839524424, 5674.517665998395, 5726.141078838166, 5760.7695692172265, 5771.624844385102, 23146.76853231463, 24273.271801845975, 25409.364765881, 25654.615180772304, 25971.870140649364, 2089.1538926734697, 2168.8048075673264, 2425.2966639674473, 2529.747025297474, 2911.5984111359103, 9729.56216970238, 10075.697729068139, 10259.589616415335, 10294.17646588271, 10313.9484302578, 1639.303296099165, 1773.3084097202102, 1801.1804628893822, 1846.8337849593602, 1883.1055248756868, 121520.39239803833, 124739.9999999991, 124896.75103249033, 127512.72487275102, 128265.0, 9159.587818548182, 11495.0, 11643.126765492452, 11697.707557311136, 11807.291562506278, 14588.635284117981, 14703.852961470247, 14716.117032978056, 14722.337494812758, 14751.852481475262, 7970.4819186752675, 8278.254957053774, 8405.159484051546, 8431.030431500334, 8542.145785421408, 6728.697208625624, 8158.632861521246, 8466.238038576557, 8473.406861519758, 8490.490570565786, 4464.866054018385, 4562.657800664897, 4568.70303430276, 4639.930401043987, 4656.0, 1569.5683686985942, 1587.3095203586477, 1728.671552405039, 1899.154876080131, 1921.990954748768, 646.3310473659834, 666.3669513961755, 904.3398319227001, 941.651588912107, 1006.6124542051363, 17985.820141798675, 20431.182752690023, 20940.057697403652, 21201.787982119982, 21422.428577819926, 888.1562515610196, 898.3846065445191, 938.3853575907655, 954.3844220477753, 1008.9859691010488, 10471.528781204865, 10933.453327333602, 11253.774924501628, 11270.0, 11271.211015229019, 479354.0, 517368.0, 571242.0, 601766.0, 606725.0, 117744.0, 123701.38149309196, 128024.0, 140506.297468512, 143101.0, 818.7134502924048, 972.8686627305365, 983.6852207293597, 990.6681261777385, 995.6764051683232, 17894.731579026586, 17935.013574253542, 17991.68199632105, 18039.917604943745, 18217.362392316205, 49093.509064908896, 52818.47181528136, 53603.46396535985, 55734.0, 56704.14943775929, 77610.6119469399, 78588.60705696435, 78617.66955443633, 78777.0, 79894.60052699699, 7617.27635874591, 7882.881756773539, 8004.119546849958, 8126.471779334324, 8168.22401871845, 10554.155667546731, 12447.564335248222, 12755.55355562588, 12870.613881583567, 12942.482300708243, 7293.708251669874, 8412.71413011194, 9209.677661281823, 10998.285111467729, 11232.213745038096, 9266.258699303904, 11252.774944501229, 11302.378369189773, 11384.544618215179, 11568.710782230175, 10914.836277455686, 11262.155338349492, 11587.768244634892, 11607.941960290145, 11620.88379116198, 6512.571610439196, 8202.958985205036, 8293.83412331738, 8342.416030878023, 8543.401961862859, 10109.848352274576, 11258.268212566158, 11470.598529051444, 11543.942280288546, 11636.650900473], "value": 9446.588083757179, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1531.7855500229966, 1570.9214539273037, 1809.7783995802838, 1900.1734245603154, 1939.6896496560553, 8063.838723225546, 8309.667613295462, 8521.531315777638, 9138.680146194885, 9173.541322933852, 8553.61508732107, 8878.200961913426, 8888.022317545065, 9020.72937811865, 9043.27653787697, 2333.8132949364053, 2382.106709983756, 2383.8569685818907, 2384.7972922301624, 2403.7836594706473, 2348.58899692554, 2383.189715496731, 2389.23544465771, 2395.0898658509827, 2397.3287479505766, 2376.774206450393, 2379.262428647125, 2390.2231774673214, 2395.173665085543, 2395.4969456414174, 2343.800776933963, 2350.0, 2353.435175557871, 2359.374765687094, 2375.904963801446, 1969.5863868587614, 1979.435860779671, 2042.5812708394744, 2352.3295860679623, 2366.93487930432, 8975.0, 9034.232090272335, 9078.319126065506, 9079.092090790935, 9092.681756138503, 4837.274408838703, 5045.798168073273, 5069.707224657725, 5494.478024587658, 5507.421720719307, 3168.2871353945407, 3433.8111403872776, 3439.8280085995602, 3563.625819288963, 3571.982140089283, 917.7338571814232, 993.2848349188573, 1052.468503405783, 1060.3226852198184, 1061.4109169410974, 11657.591984280509, 11910.225835320676, 11914.285142891455, 11948.940255298754, 11949.761004779855, 4752.714837109785, 4793.0, 4831.879203019882, 4920.065187614342, 4943.629227807929, 10091.44497052669, 10260.0, 10265.538050787733, 10288.022637849392, 10298.639547615798, 5520.0, 5529.198266251371, 5539.19681646159, 5542.722863856791, 5567.638103523258, 4478.462584489882, 4630.3748993886065, 4847.491013443609, 4979.327790748275, 5018.04657115147, 3542.964570354315, 3957.3272543667645, 4010.598940105966, 4042.757434553936, 4066.6543343815515, 1173.6009756682597, 1221.419825582841, 1288.1047671867962, 1297.695041665208, 1307.6142537951328, 771.6488997506234, 904.3307952115388, 923.2337160157188, 929.4292645429204, 946.4605175050293, 4990.725510096907, 5730.283714535683, 5903.793367232212, 5965.403459654, 6080.695965201722, 368.9022409061601, 372.8887914016247, 421.2228438530906, 431.20012377040763, 791.746641074862, 3823.5220597425323, 3846.7307288489537, 3925.4700615417123, 3950.3481925482547, 4134.73124246923, 10559.524821383056, 10832.945835270773, 10875.0, 10885.346879187275, 10914.617988370528, 8130.471519351223, 9305.069493050776, 10763.730906727238, 10916.672499825017, 10935.0, 8246.216609422096, 8314.168583141638, 8380.036295825936, 8381.11998240176, 8388.161183881562, 5673.149027645886, 5767.884642307046, 5900.350961394157, 5915.438033386993, 6059.121427393092, 8738.86394768676, 9546.61813527479, 10077.0, 10091.44497052669, 10170.0, 9752.951235243778, 10201.948990255001, 10201.948990255298, 10335.689929302132, 10360.326578772356, 6974.58152510851, 7194.89207661875, 7404.629768511661, 7612.352949999312, 7800.843983120192, 8328.042275138436, 8638.78403039929, 8647.0920553341, 8650.697225597325, 8657.437266577652, 7550.66022029021, 7677.155512893689, 7679.424043196671, 7810.336121429742, 7829.804254893673, 7365.668544915598, 7524.05949256343, 7574.848503030019, 7630.694772209272, 7639.0, 6953.513254072166, 7068.858622827617, 7082.0, 7084.822879428056, 7092.716291348288, 4936.7284799336385, 5077.060743762416, 5095.617828662939, 5164.9741751291, 5204.219367094966, 5046.243063540352, 5085.923711144262, 5103.234514822806, 5140.177571588528, 5254.527092561688], "value": 4525.287356412658, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [301.38968588608066, 303.8344102464157, 309.51869842395075, 316.7545152506808, 317.41912300490105, 4605.746683932382, 5487.722595123019, 5543.223948647193, 5574.581906357024, 5604.355499117602, 5166.793328266875, 5333.893322133555, 5452.6183167178215, 5485.725713714308, 5504.559635229182, 3636.4545318202217, 4169.812358443862, 4187.644050255732, 4196.349565817303, 4221.050263690676, 3848.9985207691984, 4109.219248342805, 4135.565765594614, 4201.978990105045, 4207.284761590522, 3560.465930110491, 4117.629413352797, 4130.607592278729, 4134.917301653965, 4154.896127596804, 3386.9322613547592, 3729.9999999999864, 4063.9390409143884, 4126.442930204444, 4128.153728485653, 3543.3346327226163, 3548.6806187442994, 3549.236914063463, 3561.305545418644, 3578.0, 4436.866893993185, 4982.085479994208, 5311.229871668586, 5319.3616765987945, 5360.195970604402, 4046.028953051276, 4085.795710214507, 4659.860204193879, 4690.319903613991, 4691.718496890164, 4772.355731976173, 4864.975675121637, 4950.529699678525, 5742.97128514359, 5795.1017592273265, 3142.4186525492855, 3694.2796154749835, 3876.2247550489733, 3936.881893543198, 4021.8939791557555, 5567.610267281292, 6080.817575472743, 6112.541559383064, 6121.296050954108, 6192.87614247717, 3319.6348401675796, 3660.9816950915606, 3803.733738638324, 3954.7231693781737, 3967.5834037425657, 3417.5898892133105, 3619.638335805348, 3880.84476620932, 3886.7279290449396, 4037.273290807624, 4615.353850460938, 4665.206914824488, 4670.95329046712, 4692.512968126898, 4706.247000479907, 5315.548178404802, 5361.758720857571, 5855.736491857877, 5906.350301466835, 5966.49284810796, 1219.8292239086536, 1282.5190553542423, 1322.7817410127413, 1336.2049580499588, 1362.7615167345675, 883.9071897450804, 901.7195582273188, 913.7395842184945, 927.7216834949488, 929.6513807322254, 5036.798528058836, 5375.2854808321545, 5455.454454554513, 5481.040817856939, 5526.806561770319, 4860.902781944412, 5534.916976245359, 5898.911516327258, 5999.670018149044, 6046.546509011841, 4777.971266869795, 5425.972870135624, 5448.237246785453, 5513.8345849624575, 5554.0, 2277.055022165816, 2326.4532834783813, 2392.138830021191, 2444.926652200437, 2611.791056715458, 4714.764261786897, 4724.834630787906, 4862.41651001882, 4943.876403089879, 5266.3943646480375, 4354.586314300136, 4652.13935421948, 4741.525847415231, 4804.927926081112, 5108.3103780989095, 4607.456502071709, 4621.445426548836, 4924.162892308244, 5059.56993655536, 5107.770150343169, 4213.957860421479, 4310.806013729327, 4453.977730111458, 4915.95084049155, 5040.765012571944, 4369.492525078843, 4786.545278198566, 4794.664373493962, 4853.80584776605, 6067.908981365372, 5487.6981766003255, 6269.5611307208055, 6331.96834015827, 6334.049892516159, 6375.968120159369, 3319.6348401675314, 3333.383324085052, 3479.251960828333, 3960.980195099006, 3990.822707301411, 4705.905881882275, 5588.692621905834, 5950.7917222896995, 6069.635821850703, 6081.32080091556, 5723.656580605177, 5821.825345239649, 5872.412758724094, 5944.0489521678055, 5976.701164941823, 5085.186370180753, 5896.764129434775, 5931.288245410578, 5994.910076348945, 6052.878942421039, 5201.271821944855, 5514.531264842373, 5688.203651488712, 5764.394738552392, 5767.365589785037, 4982.900341993068, 5393.81336106056, 5887.970560147171, 5890.676012819336, 5928.703564821828, 4386.363977223221, 5531.072938213913, 5746.683932383759, 5777.0, 5819.301683797971], "value": 4048.837672283345, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [684.6713577482811, 721.5346101764362, 767.9500832445891, 773.211324449062, 847.1570787066868, 15139.091654500739, 16399.4260200893, 16453.753193702105, 16459.423920162797, 16466.752998705015, 13140.408681609326, 14424.35090420931, 14828.925855370735, 14919.552413427587, 14940.775888361683, 677.5121912223192, 705.0341032785092, 819.2053707903355, 875.0461996423912, 877.8858748362704, 836.7364280251701, 898.3262553085186, 900.621738869673, 901.5221932375852, 901.8376692195435, 967.8790151231096, 969.1568335548083, 972.5477652891404, 973.2116985241942, 976.4531862157214, 918.2057520245007, 949.1220620925616, 956.7464621875208, 960.3997501561524, 962.5331714118647, 701.130598058404, 709.3544874164537, 711.7188710459392, 712.1134187936001, 712.6757325416922, 15103.0, 15220.086794792347, 15225.847741522553, 15226.162561059138, 15246.771298430533, 11613.6515904523, 12184.329861857594, 14507.057041292283, 14656.41374345025, 14683.55949321522, 10814.405207713573, 11276.887231127666, 11943.522259109624, 11986.400679965967, 12054.0, 3784.299904517673, 3792.4500947362476, 3831.9042023949623, 3887.1836914248042, 3892.961070389288, 116837.41581292039, 121537.0, 123820.38089809583, 125089.37455312756, 125573.0, 11120.0, 11265.831012534818, 11284.323732231258, 11303.886961130447, 11411.771764564663, 23459.530809383716, 23484.0, 23488.765112349, 23574.88212558926, 23590.17434389788, 7816.53100813953, 7865.0, 7924.960375198087, 8100.594970251464, 8198.139195384518, 4456.9331460028125, 4459.1973444779605, 4506.258141527608, 4513.390692256503, 4578.862634120982, 3612.837422316002, 3729.0, 3732.570754363283, 3737.0844143185095, 3747.213085252073, 649.4706813946618, 659.1661548141604, 674.3425160468602, 675.972961081561, 688.0298778721977, 544.1647071744852, 579.7536047180016, 666.7899611622323, 669.1602039440568, 675.6183604528751, 6982.546134501343, 7219.963900180465, 9048.50233237165, 9376.203022743006, 9523.238140948708, 566.8044524638993, 656.2715385921623, 675.2909445082644, 677.5697432130632, 677.9796606101825, 4198.160367926427, 4608.354830323758, 4641.767911604474, 4685.508021657745, 4737.265723812815, 109572.4521377404, 163829.0, 169514.0, 170082.0, 173194.0, 145256.27371863072, 146980.0, 147774.56676299727, 148172.0, 150657.0, 79358.6032069836, 85939.0, 97550.0, 98345.0, 105467.0, 9588.328816982745, 9776.315657904162, 9902.0, 9926.255530835071, 10005.0, 57531.712341438026, 57755.71122144363, 58267.4173258262, 59163.40836591579, 59886.92091963001, 74080.0, 92415.53792230996, 93741.56325930699, 96908.51545742227, 99388.50305748425, 12862.935685321514, 12952.611421657366, 13066.0, 13068.869311306766, 13201.20792752438, 14435.133891966516, 14527.273636318354, 14673.192974386084, 14716.852831471548, 15280.541583752505, 13497.730045399234, 13678.589642310746, 13752.518661846787, 13826.930865346012, 13833.79249311241, 13257.66855828612, 13442.39509222107, 13494.595162145151, 13838.723225535634, 14290.285485725464, 13422.865771342553, 13549.25479098659, 13556.0, 13560.11859229147, 13572.253526055767, 10986.890131098906, 11181.944090279821, 11379.601713939972, 11404.828927565926, 11457.942710286396, 9784.60861565558, 10132.287899065132, 10380.740481488023, 10420.32267902584, 11562.537498500302], "value": 7919.888634921115, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1579.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 118.0, 113.0, 154.0, 173.0, 170.0, 117.0, 118.0, 118.0, 119.0], "value": 130.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 101.0, 98.0, 131.0, 133.0, 105.0, 99.0, 100.0, 116.0, 100.0], "value": 115.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [194.0, 213.0, 231.0, 197.0, 194.0, 202.0, 200.0, 222.0, 258.0, 195.0], "value": 210.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 58.0, 58.0, 84.0, 59.0, 60.0, 66.0, 80.0, 99.0, 58.0], "value": 69.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 68.0, 86.0, 73.0, 68.0, 94.0, 124.0, 97.0, 100.0, 97.0], "value": 88.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 123.0, 79.0, 132.0, 136.0, 86.0, 94.0, 121.0, 90.0, 88.0], "value": 103.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 96.0, 152.0, 98.0, 96.0, 96.0, 96.0, 100.0, 151.0, 127.0], "value": 110.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 120.0, 138.0, 109.0, 91.0, 87.0, 89.0, 139.0, 94.0, 140.0], "value": 109.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 57.0, 58.0, 58.0, 57.0, 59.0, 58.0, 58.0, 59.0, 60.0], "value": 58.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 76.0, 68.0, 81.0, 80.0, 74.0, 67.0, 68.0, 89.0, 62.0], "value": 73.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 76.0, 101.0, 104.0, 110.0, 88.0, 89.0, 98.0, 114.0, 114.0], "value": 99.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [175.0, 162.0, 162.0, 142.0, 159.0, 147.0, 153.0, 147.0, 211.0, 170.0], "value": 162.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [176.0, 176.0, 177.0, 175.0, 172.0, 177.0, 175.0, 182.0, 174.0, 172.0], "value": 175.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 69.0, 68.0, 69.0, 72.0, 73.0, 68.0, 72.0, 70.0, 69.0], "value": 70.2, "unit": "score"}]}]} 13:54:06 INFO - Return code: 0 13:54:06 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:54:06 ERROR - # TBPL SUCCESS # 13:54:06 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 13:54:06 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 13:54:06 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 13:54:06 INFO - 2016-10-19 13:54:06.922 screenresolution[1672:10551] starting screenresolution argv=screenresolution get 13:54:06 INFO - 2016-10-19 13:54:06.925 screenresolution[1672:10551] Display 0: 1600x1200x32@60 13:54:06 INFO - 2016-10-19 13:54:06.931 screenresolution[1673:10554] starting screenresolution argv=screenresolution list 13:54:06 INFO - Available Modes on Display 0 13:54:06 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 13:54:06 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 13:54:06 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 13:54:06 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 13:54:07 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 13:54:07 INFO - Intel Iris: 13:54:07 INFO - Chipset Model: Intel Iris 13:54:07 INFO - Type: GPU 13:54:07 INFO - Bus: Built-In 13:54:07 INFO - VRAM (Dynamic, Max): 1536 MB 13:54:07 INFO - Vendor: Intel (0x8086) 13:54:07 INFO - Device ID: 0x0a2e 13:54:07 INFO - Revision ID: 0x0009 13:54:07 INFO - Displays: 13:54:07 INFO - Display: 13:54:07 INFO - Resolution: 1600 x 1200 @ 60 Hz 13:54:07 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 13:54:07 INFO - Display Serial Number: 1600x1200 60 13:54:07 INFO - Main Display: Yes 13:54:07 INFO - Mirror: Off 13:54:07 INFO - Online: Yes 13:54:07 INFO - Rotation: Supported 13:54:07 INFO - Return code: 0 13:54:07 INFO - Running post-action listener: _resource_record_post_action 13:54:07 INFO - [mozharness: 2016-10-19 20:54:07.167393Z] Finished run-tests step (success) 13:54:07 INFO - Running post-run listener: _resource_record_post_run 13:54:07 INFO - Total resource usage - Wall time: 1213s; CPU: 54.0%; Read bytes: 39270912; Write bytes: 712068608; Read time: 391; Write time: 2101 13:54:07 INFO - TinderboxPrint: CPU usage
54.4% 13:54:07 INFO - TinderboxPrint: I/O read bytes / time
39,270,912 / 391 13:54:07 INFO - TinderboxPrint: I/O write bytes / time
712,068,608 / 2,101 13:54:07 INFO - TinderboxPrint: CPU idle
2,215.6 (45.6%) 13:54:07 INFO - TinderboxPrint: CPU system
979.5 (20.2%) 13:54:07 INFO - TinderboxPrint: CPU user
1,658.6 (34.2%) 13:54:07 INFO - TinderboxPrint: Swap in / out
445,485,056 / 0 13:54:07 INFO - install - Wall time: 35s; CPU: 54.0%; Read bytes: 392266240; Write bytes: 383088640; Read time: 29513; Write time: 744 13:54:07 INFO - run-tests - Wall time: 1179s; CPU: 54.0%; Read bytes: 33079808; Write bytes: 301037056; Read time: 298; Write time: 1296 13:54:07 INFO - Running post-run listener: _upload_blobber_files 13:54:07 INFO - Blob upload gear active. 13:54:07 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:54:07 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 13:54:07 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'] 13:54:07 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 13:54:07 INFO - (blobuploader) - INFO - Open directory for files ... 13:54:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:54:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:54:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:54:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:54:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:54:09 INFO - (blobuploader) - INFO - Done attempting. 13:54:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:54:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:54:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:54:10 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:54:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:54:10 INFO - (blobuploader) - INFO - Done attempting. 13:54:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:54:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:54:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:54:12 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:54:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:54:12 INFO - (blobuploader) - INFO - Done attempting. 13:54:12 INFO - (blobuploader) - INFO - Iteration through files over. 13:54:12 INFO - Return code: 0 13:54:12 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:54:12 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:54:12 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3702298609a5fef38fe9237ccfb443f4d1328708075140fa4861475271698bcd756c5e29b6d0b5d6cafb666a27ee98c6dc42a84d97addb744bc1537e83aeb1a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0e3ab7e2fd2c54518dde5c7b239baca989f8502f71b6ef04696ffcdbfa199a9f50746a999288b64845aafd20bf97f410a1eab405f3bb7ea781e79cfe04d6dd7f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/cf916354ccdc5b00d9bc1f0eb3d0599bd9414b301130d8e802c420105e91e9fcb63d8beebf96a0a9aaee97cb689dda1b5947cb5f4af802d5a006c42562b4ff7d"} 13:54:12 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:54:12 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:54:12 INFO - Contents: 13:54:12 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3702298609a5fef38fe9237ccfb443f4d1328708075140fa4861475271698bcd756c5e29b6d0b5d6cafb666a27ee98c6dc42a84d97addb744bc1537e83aeb1a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0e3ab7e2fd2c54518dde5c7b239baca989f8502f71b6ef04696ffcdbfa199a9f50746a999288b64845aafd20bf97f410a1eab405f3bb7ea781e79cfe04d6dd7f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/cf916354ccdc5b00d9bc1f0eb3d0599bd9414b301130d8e802c420105e91e9fcb63d8beebf96a0a9aaee97cb689dda1b5947cb5f4af802d5a006c42562b4ff7d"} 13:54:12 INFO - Running post-run listener: copy_logs_to_upload_dir 13:54:12 INFO - Copying logs to upload dir... 13:54:12 INFO - mkdir: /builds/slave/test/build/upload/logs 13:54:12 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1275.304793 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 15 secs) (at 2016-10-19 13:54:12.940429) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-19 13:54:12.943757) ========= 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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners TMPDIR=/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3702298609a5fef38fe9237ccfb443f4d1328708075140fa4861475271698bcd756c5e29b6d0b5d6cafb666a27ee98c6dc42a84d97addb744bc1537e83aeb1a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0e3ab7e2fd2c54518dde5c7b239baca989f8502f71b6ef04696ffcdbfa199a9f50746a999288b64845aafd20bf97f410a1eab405f3bb7ea781e79cfe04d6dd7f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/cf916354ccdc5b00d9bc1f0eb3d0599bd9414b301130d8e802c420105e91e9fcb63d8beebf96a0a9aaee97cb689dda1b5947cb5f4af802d5a006c42562b4ff7d"} build_url:https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011294 build_url: 'https://queue.taskcluster.net/v1/task/EuCKnRzbSgyX8JH5GyAgPA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3702298609a5fef38fe9237ccfb443f4d1328708075140fa4861475271698bcd756c5e29b6d0b5d6cafb666a27ee98c6dc42a84d97addb744bc1537e83aeb1a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0e3ab7e2fd2c54518dde5c7b239baca989f8502f71b6ef04696ffcdbfa199a9f50746a999288b64845aafd20bf97f410a1eab405f3bb7ea781e79cfe04d6dd7f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/cf916354ccdc5b00d9bc1f0eb3d0599bd9414b301130d8e802c420105e91e9fcb63d8beebf96a0a9aaee97cb689dda1b5947cb5f4af802d5a006c42562b4ff7d"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-19 13:54:12.977558) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 13:54:12.977940) ========= 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.IdZxdI2f3Q/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.gmDRfiMXf9/Listeners TMPDIR=/var/folders/_w/5sv6_fds1bq91k_r0pg26gd800000w/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.005069 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 13:54:13.028092) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-19 13:54:13.028510) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-19 13:54:13.028925) ========= ========= Total master_lag: 0.61 =========