builder: mozilla-central_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0019 starttime: 1494425224.91 results: success (0) revision: f8d40e7fe132b7c73a8f610484b790e6063006e3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:04.912580) ========= master: http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:04.913067) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:04.913358) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:04.937275) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:04.937689) ========= 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.aPV85Ygjha/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.HPCBccPTkq/Listeners TMPDIR=/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 --2017-05-10 07:07:04-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 7.93M=0.001s 2017-05-10 07:07:05 (7.93 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.109987 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:05.070861) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:05.071199) ========= 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.aPV85Ygjha/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.HPCBccPTkq/Listeners TMPDIR=/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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.021516 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:05.119577) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2017-05-10 07:07:05.119943) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev f8d40e7fe132b7c73a8f610484b790e6063006e3 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev f8d40e7fe132b7c73a8f610484b790e6063006e3 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.aPV85Ygjha/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.HPCBccPTkq/Listeners TMPDIR=/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 2017-05-10 07:07:05,201 truncating revision to first 12 chars 2017-05-10 07:07:05,202 Setting DEBUG logging. 2017-05-10 07:07:05,202 attempt 1/10 2017-05-10 07:07:05,202 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/f8d40e7fe132?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-10 07:07:06,991 unpacking tar archive at: mozilla-central-f8d40e7fe132/testing/mozharness/ program finished with exit code 0 elapsedTime=2.059713 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2017-05-10 07:07:07.201969) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:07.202286) ========= script_repo_revision: f8d40e7fe132b7c73a8f610484b790e6063006e3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:07.202662) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:07.203500) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-10 07:07:07.222855) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 16 secs) (at 2017-05-10 07:07:07.223205) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.aPV85Ygjha/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.HPCBccPTkq/Listeners TMPDIR=/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:07:07 INFO - MultiFileLogger online at 20170510 07:07:07 in /builds/slave/test 07:07:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 07:07:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:07:07 INFO - {'append_to_log': False, 07:07:07 INFO - 'base_work_dir': '/builds/slave/test', 07:07:07 INFO - 'blob_upload_branch': 'Firefox', 07:07:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:07:07 INFO - 'branch': 'Firefox', 07:07:07 INFO - 'buildbot_json_path': 'buildprops.json', 07:07:07 INFO - 'config_files': ('talos/mac_config.py',), 07:07:07 INFO - 'default_actions': ('clobber', 07:07:07 INFO - 'read-buildbot-config', 07:07:07 INFO - 'download-and-extract', 07:07:07 INFO - 'populate-webroot', 07:07:07 INFO - 'create-virtualenv', 07:07:07 INFO - 'install', 07:07:07 INFO - 'run-tests'), 07:07:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:07:07 INFO - 'download_minidump_stackwalk': True, 07:07:07 INFO - 'download_symbols': 'ondemand', 07:07:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:07:07 INFO - 'tooltool.py': '/tools/tooltool.py', 07:07:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:07:07 INFO - '/tools/misc-python/virtualenv.py')}, 07:07:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:07:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:07:07 INFO - 'gecko_profile': False, 07:07:07 INFO - 'gecko_profile_interval': 0, 07:07:07 INFO - 'installer_path': 'installer.exe', 07:07:07 INFO - 'log_level': 'info', 07:07:07 INFO - 'log_name': 'talos', 07:07:07 INFO - 'log_to_console': True, 07:07:07 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 07:07:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 07:07:07 INFO - 'opt_config_files': (), 07:07:07 INFO - 'pip_index': False, 07:07:07 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 07:07:07 INFO - 'cmd': ('bash', 07:07:07 INFO - '-c', 07:07:07 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 07:07:07 INFO - 'enabled': True, 07:07:07 INFO - 'halt_on_failure': False, 07:07:07 INFO - 'name': 'check_screen_resolution'},), 07:07:07 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 07:07:07 INFO - 'cmd': ('bash', 07:07:07 INFO - '-c', 07:07:07 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 07:07:07 INFO - 'enabled': True, 07:07:07 INFO - 'halt_on_failure': False, 07:07:07 INFO - 'name': 'check_screen_resolution'},), 07:07:07 INFO - 'run_cmd_checks_enabled': True, 07:07:07 INFO - 'suite': 'dromaeojs', 07:07:07 INFO - 'system_bits': '32', 07:07:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:07:07 INFO - 'title': 't-yosemite-r7-0019', 07:07:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:07:07 INFO - 'use_talos_json': True, 07:07:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:07:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:07:07 INFO - 'work_dir': 'build'} 07:07:07 INFO - [mozharness: 2017-05-10 14:07:07.434303Z] Running clobber step. 07:07:07 INFO - Running pre-action listener: _resource_record_pre_action 07:07:07 INFO - Running main action method: clobber 07:07:07 INFO - rmtree: /builds/slave/test/build 07:07:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:07:09 INFO - Running post-action listener: _resource_record_post_action 07:07:09 INFO - [mozharness: 2017-05-10 14:07:09.181261Z] Finished clobber step (success) 07:07:09 INFO - [mozharness: 2017-05-10 14:07:09.181395Z] Running read-buildbot-config step. 07:07:09 INFO - Running pre-action listener: _resource_record_pre_action 07:07:09 INFO - Running main action method: read_buildbot_config 07:07:09 INFO - Using buildbot properties: 07:07:09 INFO - { 07:07:09 INFO - "project": "", 07:07:09 INFO - "product": "firefox", 07:07:09 INFO - "who": "cbook@mozilla.com", 07:07:09 INFO - "installer_path": "public/build/firefox-55.0a1.en-US.mac.dmg", 07:07:09 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs", 07:07:09 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 07:07:09 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs", 07:07:09 INFO - "stage_platform": "macosx64", 07:07:09 INFO - "basedir": "/builds/slave/test", 07:07:09 INFO - "buildnumber": 93, 07:07:09 INFO - "platform": "yosemite_r7", 07:07:09 INFO - "parent_task_id": "MGU9MRTwSzur05Fp4DmOvA", 07:07:09 INFO - "master": "http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/", 07:07:09 INFO - "slavebuilddir": "test", 07:07:09 INFO - "taskId": "AU0lIceWTl2H22WLLPoGQg", 07:07:09 INFO - "branch": "mozilla-central", 07:07:09 INFO - "script_repo_revision": "production", 07:07:09 INFO - "revision": "f8d40e7fe132b7c73a8f610484b790e6063006e3", 07:07:09 INFO - "slavename": "t-yosemite-r7-0019", 07:07:09 INFO - "repo_path": "mozilla-central" 07:07:09 INFO - } 07:07:09 INFO - Finding installer, test and symbols from parent task. 07:07:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/AU0lIceWTl2H22WLLPoGQg'}, attempt #1 07:07:10 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/AU0lIceWTl2H22WLLPoGQg'}, attempt #1 07:07:10 INFO - Task dependencies: QebKra3aTxuPMxU_HoRMTQ 07:07:10 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA'}, attempt #1 07:07:11 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.dmg 07:07:11 INFO - Set test_url: https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/test_packages.json 07:07:11 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/target.crashreporter-symbols.zip 07:07:11 INFO - Running post-action listener: _resource_record_post_action 07:07:11 INFO - [mozharness: 2017-05-10 14:07:11.030946Z] Finished read-buildbot-config step (success) 07:07:11 INFO - [mozharness: 2017-05-10 14:07:11.031080Z] Running download-and-extract step. 07:07:11 INFO - Running pre-action listener: _resource_record_pre_action 07:07:11 INFO - Running main action method: download_and_extract 07:07:11 INFO - mkdir: /builds/slave/test/build/tests 07:07:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:07:11 INFO - trying https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.test_packages.json 07:07:11 INFO - Downloading https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-55.0a1.en-US.mac.test_packages.json 07:07:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-55.0a1.en-US.mac.test_packages.json'}, attempt #1 07:07:11 INFO - Downloaded 1325 bytes. 07:07:11 INFO - Reading from file /builds/slave/test/build/firefox-55.0a1.en-US.mac.test_packages.json 07:07:11 INFO - Using the following test package requirements: 07:07:11 INFO - {u'awsy': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'firefox-55.0a1.en-US.mac.awsy.tests.zip'], 07:07:11 INFO - u'common': [u'firefox-55.0a1.en-US.mac.common.tests.zip'], 07:07:11 INFO - u'cppunittest': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'firefox-55.0a1.en-US.mac.cppunittest.tests.zip'], 07:07:11 INFO - u'gtest': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'firefox-55.0a1.en-US.mac.gtest.tests.zip'], 07:07:11 INFO - u'jittest': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'jsshell-mac.zip'], 07:07:11 INFO - u'mochitest': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'firefox-55.0a1.en-US.mac.mochitest.tests.zip'], 07:07:11 INFO - u'mozbase': [u'firefox-55.0a1.en-US.mac.common.tests.zip'], 07:07:11 INFO - u'reftest': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'firefox-55.0a1.en-US.mac.reftest.tests.zip'], 07:07:11 INFO - u'talos': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'firefox-55.0a1.en-US.mac.talos.tests.zip'], 07:07:11 INFO - u'web-platform': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'firefox-55.0a1.en-US.mac.web-platform.tests.zip'], 07:07:11 INFO - u'xpcshell': [u'firefox-55.0a1.en-US.mac.common.tests.zip', 07:07:11 INFO - u'firefox-55.0a1.en-US.mac.xpcshell.tests.zip']} 07:07:11 INFO - Downloading packages: [u'firefox-55.0a1.en-US.mac.common.tests.zip'] for test suite category: common 07:07:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.common.tests.zip 07:07:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.common.tests.zip'}, attempt #1 07:07:11 INFO - Fetch https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.common.tests.zip into memory 07:07:13 INFO - Content-Length response header: 52707641 07:07:13 INFO - Bytes received: 52707641 07:07:29 INFO - Downloading packages: [u'firefox-55.0a1.en-US.mac.common.tests.zip', u'firefox-55.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 07:07:29 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.common.tests.zip 07:07:29 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.common.tests.zip'}, attempt #1 07:07:29 INFO - Fetch https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.common.tests.zip into memory 07:07:32 INFO - Content-Length response header: 52707641 07:07:32 INFO - Bytes received: 52707641 07:07:47 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.talos.tests.zip 07:07:47 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.talos.tests.zip'}, attempt #1 07:07:47 INFO - Fetch https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.talos.tests.zip into memory 07:07:48 INFO - Content-Length response header: 14409362 07:07:48 INFO - Bytes received: 14409362 07:07:48 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')]} 07:07:48 INFO - trying https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.dmg 07:07:48 INFO - Downloading https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-55.0a1.en-US.mac.dmg 07:07:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-55.0a1.en-US.mac.dmg'}, attempt #1 07:07:50 INFO - Downloaded 75528687 bytes. 07:07:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.dmg 07:07:50 INFO - mkdir: /builds/slave/test/properties 07:07:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:07:50 INFO - Writing to file /builds/slave/test/properties/build_url 07:07:50 INFO - Contents: 07:07:50 INFO - build_url:https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.dmg 07:07:50 INFO - Running post-action listener: _resource_record_post_action 07:07:50 INFO - Running post-action listener: set_extra_try_arguments 07:07:50 INFO - [mozharness: 2017-05-10 14:07:50.878293Z] Finished download-and-extract step (success) 07:07:50 INFO - [mozharness: 2017-05-10 14:07:50.878446Z] Running populate-webroot step. 07:07:50 INFO - Running pre-action listener: _resource_record_pre_action 07:07:50 INFO - Running main action method: populate_webroot 07:07:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:07:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:07:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:07:50 INFO - '--tppagecycles', 07:07:50 INFO - '7'], 07:07:50 INFO - 'tests': ['tsvgm']}}, 07:07:50 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:07:50 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 07:07:50 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:07:50 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 07:07:50 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 07:07:50 INFO - 'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:07:50 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 07:07:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:07:50 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 07:07:50 INFO - 'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['damp', 'tps']}, 07:07:50 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 07:07:50 INFO - 'tests': ['damp', 'tps']}, 07:07:50 INFO - 'g3': {'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['dromaeo_dom']}, 07:07:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:07:50 INFO - 'g4': {'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 07:07:50 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 07:07:50 INFO - 'other': {'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['a11yr', 07:07:50 INFO - 'ts_paint', 07:07:50 INFO - 'tpaint', 07:07:50 INFO - 'sessionrestore', 07:07:50 INFO - 'sessionrestore_no_auto_restore', 07:07:50 INFO - 'tabpaint']}, 07:07:50 INFO - 'other-e10s': {'tests': ['a11yr', 07:07:50 INFO - 'ts_paint', 07:07:50 INFO - 'tpaint', 07:07:50 INFO - 'sessionrestore', 07:07:50 INFO - 'sessionrestore_no_auto_restore', 07:07:50 INFO - 'tabpaint']}, 07:07:50 INFO - 'other-e10s_l64': {'tests': ['a11yr', 07:07:50 INFO - 'ts_paint', 07:07:50 INFO - 'tpaint', 07:07:50 INFO - 'sessionrestore', 07:07:50 INFO - 'sessionrestore_no_auto_restore', 07:07:50 INFO - 'tabpaint']}, 07:07:50 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 07:07:50 INFO - 'ts_paint', 07:07:50 INFO - 'tpaint', 07:07:50 INFO - 'sessionrestore', 07:07:50 INFO - 'sessionrestore_no_auto_restore', 07:07:50 INFO - 'tabpaint']}, 07:07:50 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['a11yr', 07:07:50 INFO - 'ts_paint', 07:07:50 INFO - 'tpaint', 07:07:50 INFO - 'sessionrestore', 07:07:50 INFO - 'sessionrestore_no_auto_restore', 07:07:50 INFO - 'tabpaint']}, 07:07:50 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['a11yr', 07:07:50 INFO - 'ts_paint', 07:07:50 INFO - 'tpaint', 07:07:50 INFO - 'sessionrestore', 07:07:50 INFO - 'sessionrestore_no_auto_restore', 07:07:50 INFO - 'tabpaint']}, 07:07:50 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 07:07:50 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 07:07:50 INFO - 'bloom_basic_ref']}, 07:07:50 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['tsvgx', 07:07:50 INFO - 'tsvgr_opacity', 07:07:50 INFO - 'tart', 07:07:50 INFO - 'tscrollx', 07:07:50 INFO - 'cart', 07:07:50 INFO - 'tsvg_static']}, 07:07:50 INFO - 'svgr-e10s': {'tests': ['tsvgx', 07:07:50 INFO - 'tsvgr_opacity', 07:07:50 INFO - 'tart', 07:07:50 INFO - 'tscrollx', 07:07:50 INFO - 'cart', 07:07:50 INFO - 'tsvg_static']}, 07:07:50 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 07:07:50 INFO - 'talos_options': ['--disable-e10s'], 07:07:50 INFO - 'tests': ['tp5o']}, 07:07:50 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 07:07:50 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 07:07:50 INFO - 'talos_options': ['--disable-e10s', 07:07:50 INFO - '--xperf_path', 07:07:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:07:50 INFO - 'tests': ['tp5n']}, 07:07:50 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 07:07:50 INFO - 'talos_options': ['--xperf_path', 07:07:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:07:50 INFO - 'tests': ['tp5n']}}, 07:07:50 INFO - 'talos.zip': {'path': '', 07:07:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:07:50 INFO - Running post-action listener: _resource_record_post_action 07:07:50 INFO - [mozharness: 2017-05-10 14:07:50.899137Z] Finished populate-webroot step (success) 07:07:50 INFO - [mozharness: 2017-05-10 14:07:50.899280Z] Running create-virtualenv step. 07:07:50 INFO - Running pre-action listener: _resource_record_pre_action 07:07:50 INFO - Running main action method: create_virtualenv 07:07:50 INFO - Creating virtualenv /builds/slave/test/build/venv 07:07:50 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 07:07:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:07:51 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:07:51 INFO - Using real prefix '/tools/python27' 07:07:51 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:07:51 INFO - Installing distribute.............................................................................................................................................................................................done. 07:07:54 INFO - Installing pip.................done. 07:07:54 INFO - Return code: 0 07:07:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 07:07:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 07:07:54 INFO - Reading from file tmpfile_stdout 07:07:54 INFO - Output received: 07:07:54 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) 07:07:54 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:07:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:07:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:07:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:07:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:07:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:07:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:07:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:07:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 07:07:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:07:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:07:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:07:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:07:54 INFO - 'HOME': '/Users/cltbld', 07:07:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:07:54 INFO - 'LOGNAME': 'cltbld', 07:07:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:07:54 INFO - 'MOZ_NO_REMOTE': '1', 07:07:54 INFO - 'NO_EM_RESTART': '1', 07:07:54 INFO - 'PAGER': '/bin/cat', 07:07:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:07:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:07:54 INFO - 'PWD': '/builds/slave/test', 07:07:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:07:54 INFO - 'SHELL': '/bin/bash', 07:07:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:07:54 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:07:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:07:54 INFO - 'USER': 'cltbld', 07:07:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:07:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:07:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:07:54 INFO - 'XPC_FLAGS': '0x0', 07:07:54 INFO - 'XPC_SERVICE_NAME': '0', 07:07:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:07:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:07:55 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 07:07:55 INFO - Cleaning up... 07:07:55 INFO - Return code: 0 07:07:55 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 07:07:55 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')]} 07:07:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:07:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:07:55 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')]} 07:07:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:07:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:07:55 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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:07:55 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 07:07:55 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 07:07:55 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:07:55 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:07:55 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:07:55 INFO - 'HOME': '/Users/cltbld', 07:07:55 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:07:55 INFO - 'LOGNAME': 'cltbld', 07:07:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:07:55 INFO - 'MOZ_NO_REMOTE': '1', 07:07:55 INFO - 'NO_EM_RESTART': '1', 07:07:55 INFO - 'PAGER': '/bin/cat', 07:07:55 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:07:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:07:55 INFO - 'PWD': '/builds/slave/test', 07:07:55 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:07:55 INFO - 'SHELL': '/bin/bash', 07:07:55 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:07:55 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:07:55 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:07:55 INFO - 'USER': 'cltbld', 07:07:55 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:07:55 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:07:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:07:55 INFO - 'XPC_FLAGS': '0x0', 07:07:55 INFO - 'XPC_SERVICE_NAME': '0', 07:07:55 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:07:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:07:55 INFO - Downloading/unpacking psutil>=3.1.1 07:07:55 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 07:07:55 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 07:07:55 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 07:07:55 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 07:07:55 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 07:07:55 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 07:07:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:07:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:07:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:07:57 INFO - Installing collected packages: psutil 07:07:57 INFO - Running setup.py install for psutil 07:07:57 INFO - building 'psutil._psutil_osx' extension 07:07:57 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 07:07:58 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 07:07:58 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 07:07:58 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 07:07:58 INFO - building 'psutil._psutil_posix' extension 07:07:58 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 07:07:58 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 07:07:58 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 07:07:58 INFO - ^ 07:07:58 INFO - 1 warning generated. 07:07:58 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 07:07:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:07:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:07:58 INFO - Successfully installed psutil 07:07:58 INFO - Cleaning up... 07:07:58 INFO - Return code: 0 07:07:58 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 07:07:58 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')]} 07:07:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:07:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:07:58 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')]} 07:07:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:07:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:07:58 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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:07:58 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 07:07:58 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 07:07:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:07:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:07:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:07:58 INFO - 'HOME': '/Users/cltbld', 07:07:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:07:58 INFO - 'LOGNAME': 'cltbld', 07:07:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:07:58 INFO - 'MOZ_NO_REMOTE': '1', 07:07:58 INFO - 'NO_EM_RESTART': '1', 07:07:58 INFO - 'PAGER': '/bin/cat', 07:07:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:07:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:07:58 INFO - 'PWD': '/builds/slave/test', 07:07:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:07:58 INFO - 'SHELL': '/bin/bash', 07:07:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:07:58 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:07:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:07:58 INFO - 'USER': 'cltbld', 07:07:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:07:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:07:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:07:58 INFO - 'XPC_FLAGS': '0x0', 07:07:58 INFO - 'XPC_SERVICE_NAME': '0', 07:07:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:07:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:07:58 INFO - Downloading/unpacking mozsystemmonitor==0.3 07:07:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:07:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:07:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:07:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:07:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:07:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:08:00 INFO - Downloading mozsystemmonitor-0.3.tar.gz 07:08:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:08:00 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 07:08:00 INFO - Installing collected packages: mozsystemmonitor 07:08:00 INFO - Running setup.py install for mozsystemmonitor 07:08:00 INFO - Successfully installed mozsystemmonitor 07:08:00 INFO - Cleaning up... 07:08:00 INFO - Return code: 0 07:08:00 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 07:08: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')]} 07:08:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:08:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08: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')]} 07:08:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:08:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:00 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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:08:00 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 07:08:00 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 07:08:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:08:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:08:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:08:00 INFO - 'HOME': '/Users/cltbld', 07:08:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:08:00 INFO - 'LOGNAME': 'cltbld', 07:08:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:08:00 INFO - 'MOZ_NO_REMOTE': '1', 07:08:00 INFO - 'NO_EM_RESTART': '1', 07:08:00 INFO - 'PAGER': '/bin/cat', 07:08:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:08:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:08:00 INFO - 'PWD': '/builds/slave/test', 07:08:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:08:00 INFO - 'SHELL': '/bin/bash', 07:08:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:08:00 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:08:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:08:00 INFO - 'USER': 'cltbld', 07:08:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:08:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:08:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:08:00 INFO - 'XPC_FLAGS': '0x0', 07:08:00 INFO - 'XPC_SERVICE_NAME': '0', 07:08:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:08:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:08:00 INFO - Downloading/unpacking jsonschema==2.5.1 07:08:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:08:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:08:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:08:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:08:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:08:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:08:02 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:08:02 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 07:08:02 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 07:08:02 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 07:08:02 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 07:08:02 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 07:08:02 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 07:08:02 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 07:08:02 INFO - Downloading functools32-3.2.3-2.tar.gz 07:08:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:08:02 INFO - warning: no files found matching '*.txt' 07:08:02 INFO - no previously-included directories found matching 'build' 07:08:02 INFO - no previously-included directories found matching 'dist' 07:08:02 INFO - no previously-included directories found matching '.git*' 07:08:02 INFO - Installing collected packages: jsonschema, functools32 07:08:02 INFO - Running setup.py install for functools32 07:08:03 INFO - warning: no files found matching '*.txt' 07:08:03 INFO - no previously-included directories found matching 'build' 07:08:03 INFO - no previously-included directories found matching 'dist' 07:08:03 INFO - no previously-included directories found matching '.git*' 07:08:03 INFO - Successfully installed jsonschema functools32 07:08:03 INFO - Cleaning up... 07:08:03 INFO - Return code: 0 07:08:03 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 07:08:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:08:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:08:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:08:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 07:08:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 07:08:03 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:08:03 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:08:03 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:08:03 INFO - 'HOME': '/Users/cltbld', 07:08:03 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:08:03 INFO - 'LOGNAME': 'cltbld', 07:08:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:08:03 INFO - 'MOZ_NO_REMOTE': '1', 07:08:03 INFO - 'NO_EM_RESTART': '1', 07:08:03 INFO - 'PAGER': '/bin/cat', 07:08:03 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:08:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:08:03 INFO - 'PWD': '/builds/slave/test', 07:08:03 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:08:03 INFO - 'SHELL': '/bin/bash', 07:08:03 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:08:03 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:08:03 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:08:03 INFO - 'USER': 'cltbld', 07:08:03 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:08:03 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:08:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:08:03 INFO - 'XPC_FLAGS': '0x0', 07:08:03 INFO - 'XPC_SERVICE_NAME': '0', 07:08:03 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:08:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:08:03 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 07:08:03 INFO - Cleaning up... 07:08:03 INFO - Return code: 0 07:08:03 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:08:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:08:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:08:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:08:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 07:08:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 07:08:03 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:08:03 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:08:03 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:08:03 INFO - 'HOME': '/Users/cltbld', 07:08:03 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:08:03 INFO - 'LOGNAME': 'cltbld', 07:08:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:08:03 INFO - 'MOZ_NO_REMOTE': '1', 07:08:03 INFO - 'NO_EM_RESTART': '1', 07:08:03 INFO - 'PAGER': '/bin/cat', 07:08:03 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:08:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:08:03 INFO - 'PWD': '/builds/slave/test', 07:08:03 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:08:03 INFO - 'SHELL': '/bin/bash', 07:08:03 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:08:03 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:08:03 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:08:03 INFO - 'USER': 'cltbld', 07:08:03 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:08:03 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:08:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:08:03 INFO - 'XPC_FLAGS': '0x0', 07:08:03 INFO - 'XPC_SERVICE_NAME': '0', 07:08:03 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:08:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:08:03 INFO - Downloading/unpacking blobuploader==1.2.4 07:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:08:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:08:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:08:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:08:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:08:05 INFO - Downloading blobuploader-1.2.4.tar.gz 07:08:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:08:05 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:08:05 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 07:08:05 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 07:08:05 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 07:08:05 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 07:08:05 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 07:08:05 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 07:08:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:08:05 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:08:05 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 07:08:05 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 07:08:05 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 07:08:05 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 07:08:05 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 07:08:05 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 07:08:06 INFO - Downloading docopt-0.6.1.tar.gz 07:08:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:08:06 INFO - Installing collected packages: blobuploader, requests, docopt 07:08:06 INFO - Running setup.py install for blobuploader 07:08:06 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:08:06 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:08:06 INFO - Running setup.py install for requests 07:08:06 INFO - Running setup.py install for docopt 07:08:07 INFO - Successfully installed blobuploader requests docopt 07:08:07 INFO - Cleaning up... 07:08:07 INFO - Return code: 0 07:08:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:08:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:08:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:08:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:07 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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:08:07 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 07:08:07 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 07:08:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:08:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:08:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:08:07 INFO - 'HOME': '/Users/cltbld', 07:08:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:08:07 INFO - 'LOGNAME': 'cltbld', 07:08:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:08:07 INFO - 'MOZ_NO_REMOTE': '1', 07:08:07 INFO - 'NO_EM_RESTART': '1', 07:08:07 INFO - 'PAGER': '/bin/cat', 07:08:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:08:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:08:07 INFO - 'PWD': '/builds/slave/test', 07:08:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:08:07 INFO - 'SHELL': '/bin/bash', 07:08:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:08:07 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:08:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:08:07 INFO - 'USER': 'cltbld', 07:08:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:08:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:08:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:08:07 INFO - 'XPC_FLAGS': '0x0', 07:08:07 INFO - 'XPC_SERVICE_NAME': '0', 07:08:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:08:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:08:07 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-HE98kx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:08:07 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-88X3xz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:08:07 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-T1ulUo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:08:07 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-NnDGQg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:08:07 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-S0lhhW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:08:07 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-fLC9jg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-cjkL7W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-lzKF7x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-GHkj_b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-tuZkJx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-7wKJcZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-82QltY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-JVTbcy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-mau5XM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-3k_Nej-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:08:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:08:08 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-ERehys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:08:09 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-4COYZ7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:08:09 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:08:09 INFO - Running setup.py install for manifestparser 07:08:09 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:08:09 INFO - Running setup.py install for mozcrash 07:08:09 INFO - Running setup.py install for mozdebug 07:08:09 INFO - Running setup.py install for mozdevice 07:08:09 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:08:09 INFO - Running setup.py install for mozfile 07:08:09 INFO - Running setup.py install for mozhttpd 07:08:10 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:08:10 INFO - Running setup.py install for mozinfo 07:08:10 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:08:10 INFO - Running setup.py install for mozInstall 07:08:10 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:08:10 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:08:10 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:08:10 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:08:10 INFO - Running setup.py install for mozleak 07:08:10 INFO - Running setup.py install for mozlog 07:08:10 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:08:10 INFO - Running setup.py install for moznetwork 07:08:10 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:08:10 INFO - Running setup.py install for mozprocess 07:08:10 INFO - Running setup.py install for mozprofile 07:08:11 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:08:11 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:08:11 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:08:11 INFO - Running setup.py install for mozrunner 07:08:11 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:08:11 INFO - Running setup.py install for mozscreenshot 07:08:11 INFO - Running setup.py install for moztest 07:08:11 INFO - Running setup.py install for mozversion 07:08:11 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:08:11 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:08:11 INFO - Cleaning up... 07:08:11 INFO - Return code: 0 07:08:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:08:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:08:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:08:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:11 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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:08:11 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 07:08:11 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 07:08:11 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:08:11 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:08:11 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:08:11 INFO - 'HOME': '/Users/cltbld', 07:08:11 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:08:11 INFO - 'LOGNAME': 'cltbld', 07:08:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:08:11 INFO - 'MOZ_NO_REMOTE': '1', 07:08:11 INFO - 'NO_EM_RESTART': '1', 07:08:11 INFO - 'PAGER': '/bin/cat', 07:08:11 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:08:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:08:11 INFO - 'PWD': '/builds/slave/test', 07:08:11 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:08:11 INFO - 'SHELL': '/bin/bash', 07:08:11 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:08:11 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:08:11 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:08:11 INFO - 'USER': 'cltbld', 07:08:11 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:08:11 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:08:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:08:11 INFO - 'XPC_FLAGS': '0x0', 07:08:11 INFO - 'XPC_SERVICE_NAME': '0', 07:08:11 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:08:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-dn3tsY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:08:12 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-ZcHz42-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:08:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-4fo80E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:08:12 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-omMosG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:08:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-lSvR5y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:08:12 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-eWfxhK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:08:12 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-07U2Fg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:08:12 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-SvbGrk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:08:12 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-6tsvHv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:08:12 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)) 07:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:08:12 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-jMzTJm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:08:13 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)) 07:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:08:13 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-90JnFC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:08:13 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)) 07:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:08:13 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-rfANbl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:08:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 07:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:08:13 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-lkJgIS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:08:13 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)) 07:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:08:13 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-KWBAsY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:08:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 07:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:08:13 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-P_F5IO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:08:13 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)) 07:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:08:13 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-WEUBLG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:08:13 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 07:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:08:13 INFO - Running setup.py (path:/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/pip-akXgsG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:08:13 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)) 07:08:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:08:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:08:13 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)) 07:08:13 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:08:13 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:08:13 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:08:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:08:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:08:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:08:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:08:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:08:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:08:15 INFO - Downloading blessings-1.6.tar.gz 07:08:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:08:15 INFO - Installing collected packages: blessings 07:08:15 INFO - Running setup.py install for blessings 07:08:15 INFO - Successfully installed blessings 07:08:15 INFO - Cleaning up... 07:08:15 INFO - Return code: 0 07:08:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:08:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:08:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:08:15 INFO - Reading from file tmpfile_stdout 07:08:15 INFO - Current package versions: 07:08:15 INFO - blessings == 1.6 07:08:15 INFO - blobuploader == 1.2.4 07:08:15 INFO - docopt == 0.6.1 07:08:15 INFO - functools32 == 3.2.3-2 07:08:15 INFO - jsonschema == 2.5.1 07:08:15 INFO - manifestparser == 1.1 07:08:15 INFO - mozInstall == 1.12 07:08:15 INFO - mozcrash == 1.0 07:08:15 INFO - mozdebug == 0.1 07:08:15 INFO - mozdevice == 0.50 07:08:15 INFO - mozfile == 1.2 07:08:15 INFO - mozhttpd == 0.7 07:08:15 INFO - mozinfo == 0.9 07:08:15 INFO - mozleak == 0.1 07:08:15 INFO - mozlog == 3.4 07:08:15 INFO - moznetwork == 0.27 07:08:15 INFO - mozprocess == 0.25 07:08:15 INFO - mozprofile == 0.28 07:08:15 INFO - mozrunner == 6.13 07:08:15 INFO - mozscreenshot == 0.1 07:08:15 INFO - mozsystemmonitor == 0.3 07:08:15 INFO - moztest == 0.8 07:08:15 INFO - mozversion == 1.4 07:08:15 INFO - psutil == 3.1.1 07:08:15 INFO - requests == 1.2.3 07:08:15 INFO - wsgiref == 0.1.2 07:08:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:08:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:08:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:08:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:15 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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:08:15 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 07:08:15 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 07:08:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:08:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:08:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:08:15 INFO - 'HOME': '/Users/cltbld', 07:08:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:08:15 INFO - 'LOGNAME': 'cltbld', 07:08:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:08:15 INFO - 'MOZ_NO_REMOTE': '1', 07:08:15 INFO - 'NO_EM_RESTART': '1', 07:08:15 INFO - 'PAGER': '/bin/cat', 07:08:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:08:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:08:15 INFO - 'PWD': '/builds/slave/test', 07:08:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:08:15 INFO - 'SHELL': '/bin/bash', 07:08:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:08:15 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:08:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:08:15 INFO - 'USER': 'cltbld', 07:08:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:08:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:08:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:08:15 INFO - 'XPC_FLAGS': '0x0', 07:08:15 INFO - 'XPC_SERVICE_NAME': '0', 07:08:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:08:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 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)) 07:08:16 INFO - Cleaning up... 07:08:16 INFO - Return code: 0 07:08:16 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:08:16 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')]} 07:08:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:08:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:16 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')]} 07:08:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:08:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:08:16 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 0x10d03fb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d042768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1c9ccaee0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, '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.aPV85Ygjha/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.HPCBccPTkq/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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 07:08:16 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 07:08:16 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 07:08:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:08:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:08:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:08:16 INFO - 'HOME': '/Users/cltbld', 07:08:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:08:16 INFO - 'LOGNAME': 'cltbld', 07:08:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:08:16 INFO - 'MOZ_NO_REMOTE': '1', 07:08:16 INFO - 'NO_EM_RESTART': '1', 07:08:16 INFO - 'PAGER': '/bin/cat', 07:08:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:08:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:08:16 INFO - 'PWD': '/builds/slave/test', 07:08:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:08:16 INFO - 'SHELL': '/bin/bash', 07:08:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:08:16 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:08:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:08:16 INFO - 'USER': 'cltbld', 07:08:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:08:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:08:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:08:16 INFO - 'XPC_FLAGS': '0x0', 07:08:16 INFO - 'XPC_SERVICE_NAME': '0', 07:08:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:08:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:08:16 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 07:08:16 INFO - Cleaning up... 07:08:16 INFO - Return code: 0 07:08:16 INFO - Running post-action listener: _resource_record_post_action 07:08:16 INFO - Running post-action listener: _start_resource_monitoring 07:08:16 INFO - Starting resource monitoring. 07:08:16 INFO - [mozharness: 2017-05-10 14:08:16.382201Z] Finished create-virtualenv step (success) 07:08:16 INFO - [mozharness: 2017-05-10 14:08:16.383195Z] Running install step. 07:08:16 INFO - Running pre-action listener: _resource_record_pre_action 07:08:16 INFO - Running main action method: install 07:08:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:08:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:08:16 INFO - Reading from file tmpfile_stdout 07:08:16 INFO - Detecting whether we're running mozinstall >=1.0... 07:08:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:08:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:08:16 INFO - Reading from file tmpfile_stdout 07:08:16 INFO - Output received: 07:08:16 INFO - Usage: mozinstall [options] installer 07:08:16 INFO - Options: 07:08:16 INFO - -h, --help show this help message and exit 07:08:16 INFO - -d DEST, --destination=DEST 07:08:16 INFO - Directory to install application into. [default: 07:08:16 INFO - "/builds/slave/test"] 07:08:16 INFO - --app=APP Application being installed. [default: firefox] 07:08:16 INFO - mkdir: /builds/slave/test/build/application 07:08:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-55.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 07:08:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-55.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 07:08:37 INFO - Reading from file tmpfile_stdout 07:08:37 INFO - Output received: 07:08:37 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 07:08:37 INFO - Running post-action listener: _resource_record_post_action 07:08:37 INFO - [mozharness: 2017-05-10 14:08:37.070339Z] Finished install step (success) 07:08:37 INFO - [mozharness: 2017-05-10 14:08:37.070503Z] Running run-tests step. 07:08:37 INFO - Running pre-action listener: _resource_record_pre_action 07:08:37 INFO - Running main action method: run_tests 07:08:37 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 07:08:37 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 07:08:37 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 07:08:37 INFO - 2017-05-10 07:08:37.084 screenresolution[2339:28704] starting screenresolution argv=screenresolution get 07:08:37 INFO - 2017-05-10 07:08:37.087 screenresolution[2339:28704] Display 0: 1600x1200x32@60 07:08:37 INFO - 2017-05-10 07:08:37.093 screenresolution[2340:28707] starting screenresolution argv=screenresolution list 07:08:37 INFO - Available Modes on Display 0 07:08:37 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 07:08:37 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 07:08:37 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 07:08:37 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 07:08:37 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 07:08:37 INFO - Intel Iris: 07:08:37 INFO - Chipset Model: Intel Iris 07:08:37 INFO - Type: GPU 07:08:37 INFO - Bus: Built-In 07:08:37 INFO - VRAM (Dynamic, Max): 1536 MB 07:08:37 INFO - Vendor: Intel (0x8086) 07:08:37 INFO - Device ID: 0x0a2e 07:08:37 INFO - Revision ID: 0x0009 07:08:37 INFO - Displays: 07:08:37 INFO - Display: 07:08:37 INFO - Resolution: 1600 x 1200 @ 60 Hz 07:08:37 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 07:08:37 INFO - Display Serial Number: 1600x1200 60 07:08:37 INFO - Main Display: Yes 07:08:37 INFO - Mirror: Off 07:08:37 INFO - Online: Yes 07:08:37 INFO - Rotation: Supported 07:08:37 INFO - Return code: 0 07:08:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:08:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:08:37 INFO - Python 2.7.3 07:08:37 INFO - Return code: 0 07:08:37 INFO - grabbing minidump binary from tooltool 07:08:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 07:08:37 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 0x10cd50d30>, '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 0x10cd03db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10cd44be8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:08:37 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 07:08:37 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 07:08:37 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 07:08:37 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:08:37 INFO - Return code: 0 07:08:37 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 07:08:37 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:08:37 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:08:37 INFO - ENV: RUST_BACKTRACE is now 1 07:08:37 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 07:08:37 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:08:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0019', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 07:08:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/target.crashreporter-symbols.zip --title t-yosemite-r7-0019 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 07:08:37 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.aPV85Ygjha/Render', 07:08:37 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 07:08:37 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 07:08:37 INFO - 'HOME': '/Users/cltbld', 07:08:37 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 07:08:37 INFO - 'LOGNAME': 'cltbld', 07:08:37 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:08:37 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 07:08:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:08:37 INFO - 'MOZ_NO_REMOTE': '1', 07:08:37 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:08:37 INFO - 'NO_EM_RESTART': '1', 07:08:37 INFO - 'PAGER': '/bin/cat', 07:08:37 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 07:08:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:08:37 INFO - 'PWD': '/builds/slave/test', 07:08:37 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:08:37 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 07:08:37 INFO - 'RUST_BACKTRACE': '1', 07:08:37 INFO - 'SHELL': '/bin/bash', 07:08:37 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.HPCBccPTkq/Listeners', 07:08:37 INFO - 'TMPDIR': '/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/', 07:08:37 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 07:08:37 INFO - 'USER': 'cltbld', 07:08:37 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 07:08:37 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 07:08:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:08:37 INFO - 'XPC_FLAGS': '0x0', 07:08:37 INFO - 'XPC_SERVICE_NAME': '0', 07:08:37 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 07:08:37 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0019', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 07:08:37 INFO - mozversion application_buildid: 20170510050843 07:08:37 INFO - mozversion application_changeset: f8d40e7fe132b7c73a8f610484b790e6063006e3 07:08:37 INFO - mozversion application_display_name: Nightly 07:08:37 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:08:37 INFO - mozversion application_name: Firefox 07:08:37 INFO - mozversion application_remotingname: firefox 07:08:37 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 07:08:37 INFO - mozversion application_vendor: Mozilla 07:08:37 INFO - mozversion application_version: 55.0a1 07:08:37 INFO - mozversion platform_buildid: 20170510050843 07:08:37 INFO - mozversion platform_changeset: f8d40e7fe132b7c73a8f610484b790e6063006e3 07:08:37 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 07:08:37 INFO - mozversion platform_version: 55.0a1 07:08:37 INFO - using testdate: 1494425317 07:08:37 INFO - actual date: 1494425317 07:08:37 INFO - starting webserver on 'localhost:55003' 07:08:37 INFO - SUITE-START | Running 2 tests 07:08:37 INFO - TEST-START | dromaeo_css 07:08:37 INFO - operating with platform_type : mac_ 07:08:37 INFO - Initialising browser for dromaeo_css test... 07:08:37 INFO - TEST-INFO | started process 2350 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/tmpfNT1vu/profile http://localhost:55003/getInfo.html) 07:08:40 INFO - PID 2350 | __metrics Screen width/height:1600/1200 07:08:40 INFO - PID 2350 | colorDepth:24 07:08:40 INFO - PID 2350 | Browser inner width/height: 1024/691 07:08:40 INFO - PID 2350 | __metrics 07:08:40 INFO - PID 2350 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 07:08:40 INFO - PID 2350 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 334: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:08:41 INFO - TEST-INFO | 2350: exit 0 07:08:41 INFO - Browser initialized. 07:08:41 INFO - Running cycle 1/1 for dromaeo_css test... 07:08:41 INFO - TEST-INFO | started process 2352 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/tmpfNT1vu/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:08:53 INFO - PID 2352 | RSS: Main: 234414080 07:08:53 INFO - PID 2352 | 07:11:58 INFO - PID 2352 | Cycle 1(1): loaded http://localhost:55003/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55003/tests/dromaeo/cssquery-ext.html) 07:12:00 INFO - PID 2352 | RSS: Main: 397377536 07:12:00 INFO - PID 2352 | 07:15:02 INFO - PID 2352 | Cycle 1(1): loaded http://localhost:55003/tests/dromaeo/cssquery-ext.html (next: http://localhost:55003/tests/dromaeo/cssquery-jquery.html) 07:15:03 INFO - PID 2352 | RSS: Main: 370835456 07:15:03 INFO - PID 2352 | 07:18:05 INFO - PID 2352 | Cycle 1(1): loaded http://localhost:55003/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55003/tests/dromaeo/cssquery-mootools.html) 07:18:06 INFO - PID 2352 | RSS: Main: 337915904 07:18:06 INFO - PID 2352 | 07:21:08 INFO - PID 2352 | Cycle 1(1): loaded http://localhost:55003/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55003/tests/dromaeo/cssquery-prototype.html) 07:21:09 INFO - PID 2352 | RSS: Main: 335458304 07:21:09 INFO - PID 2352 | 07:24:13 INFO - PID 2352 | Cycle 1(1): loaded http://localhost:55003/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55003/tests/dromaeo/cssquery-yui.html) 07:24:13 INFO - PID 2352 | RSS: Main: 331276288 07:24:13 INFO - PID 2352 | 07:27:15 INFO - PID 2352 | Cycle 1(1): loaded http://localhost:55003/tests/dromaeo/cssquery-yui.html (next: http://localhost:55003/tests/dromaeo/cssquery-dojo.html) 07:27:16 INFO - PID 2352 | RSS: Main: 371752960 07:27:16 INFO - PID 2352 | 07:27:16 INFO - PID 2352 | __start_tp_report 07:27:16 INFO - PID 2352 | _x_x_mozilla_page_load 07:27:16 INFO - PID 2352 | _x_x_mozilla_page_load_details 07:27:16 INFO - PID 2352 | |i|pagename|runs| 07:27:16 INFO - PID 2352 | |0;dojo.html;3225.435548778964;3516.1033936346244;3531.4879342495324;3542.0790594445452;3583.874564390247;5986.970065149679;6135.938640613593;6199.039148931912;6205.627662340257;6211.689415529222;6009.759609615621;6041.939580604193;6055.5761096723245;6067.302260240073;6073.969630151854;5210.843674689746;5257.395399529065;5264.552513036397;5268.209768534713;5341.4925582069645;4087.386891966214;5179.834537229131;5418.9458105418835;5467.781288748465;5489.862753431176;5404.432534583871;5408.35099788024;5429.647072940266;5432.538234250093;5443.428440013801;5186.844394668166;5307.814226502092;5447.863803404926;5463.399026107125;5508.03609368359;4336.522982471925;5333.813316533941;5353.625246232766;5369.677819330814;5380.24676545284;6007.729652165663;6129.693515324216;6133.723982420802;6145.508359331243;6154.984427569446;6293.213348331458;6363.236411630634;6495.285518592951;6505;6512;6393.041043843415;6465.3534646535445;6553;6565.441937435324;6687.097241872334;6237.282712488077;6243.063540468966;6243.719032643542;6254.937450625526;6257.186565746424;6711.899321510181;6770;6774.220964589037;6775.72897084121;6795.932040679629;6289.339619339903;6297.4962003039645;6379.170707807955;6393.1369265148605;6415.005674120519;6432.614043157332;6433.613983160932;6435.388638079375;6445.291017988017;6452.064450654629;6348.3969022943675;6369.394907483782;6388.265349484869;6405.6797160141805;6456.806295811133;6463.192100987377;6466;6476.740930362733;6489.643069631121;6505.902411463831;5228.660137091077;5234.371875374979;5243.8164664236565;5245.790168393221;5263.6578622389425;4513.9617887885315;4548.658850586219;4570.862874113782;4654.813807447664;4687.015726697364;6214.378562143749;6236.906446403307;6250.593711408744;6258.186435763321;6262.906056409158;6589.86820263592;6590.637514936724;6600.834979125464;6611.834704132339;6628.96685516579;5021.297018417425;6150.477209437158;6273.905891411632;6280.748770049238;6314;5711.086226203787;5720.542356611461;5730.025895597675;5738.655680659173;5740.655560666373;6632.336766323329;6632.83417914556;6632.90050649231;6647.534672572873;6647.60114393138;6375.075614035846;6428.710708018244;6432.614043157426;6433.388828061326;6453.032045193258;6626.801195964129;6725.9663701681175;6822.11312529368;6826.180858297036;6834.589924604539;6454;6475.935240647534;6491.545591808528;6494.577852439576;6496.220453545416;6415.871682566416;6468.935310646833;6470.22357317125;6546.345365463416;6609.272979972103;6209.875802484015;6276.278228003838;6380.3619638035825;6392.712327945161;6412.102305677302;5281.7887284509725;6329.651869147241;6334.081558174131;6399.776007839703;6400.103985441949;6149.41580549847;6276.811695649138;6283.59156654816;6307.526935479949;6312.779052733316;6353.5870168438905;6361.363863613602;6372.681365931592;6376.840578985562;6379.043143528508;6136.549713441251;6315.210598675166;6317.905231421624;6329.683515824282;6331.018692102732 07:27:16 INFO - PID 2352 | |1;ext.html;680.9353111454411;753.3333000294738;801.1387758159977;1017.506509342969;1113.4488428228028;26072.08747693831;31421.900233491804;35164.82417587908;36293.455598166016;36873;38415.03962400941;38629;38737.03157421066;38776;38797.22405551887;6005.609635373687;8196.631151598178;8338.66645334189;8350.039745429292;8362.121977192399;5961.314448838374;6275.372462753734;8342.916570834304;8345.916540834605;8354.45696029756;8401.789955251137;8430.241278284953;8440.83118337636;8442.57787110645;8537.274331681814;8360.832783344329;8390.580470976487;8411.95794021032;8412.411131220817;8412.537310447922;5920.822375328747;5950.702464876739;8030.156833532512;8172.6322315495945;8189.631466584018;36188.45717314242;36369.45445818288;36467.817660911525;36515.26969460623;36629.81685091584;3458.1008937676384;3495.842687079062;3496.5454490916018;3498.2129020970333;3498.772579782306;29695.70304296951;29801;29804.552931706043;29844.70155298441;29845;3071.17078388836;3129.624445066584;3156.9842150789327;3176.491761318201;3181.6341120771176;267327;267555;267828;267834;268130;39067.41398879019;48291;48301.033979320215;48307.27539086917;48391.5160848387;50520.49479505158;50539.49460505348;50653.746731266845;50677.74661126671;50692.746536267085;14066.71866562663;14145.787813182811;14155.575332740034;14164.36260368286;14179.574612761633;9898.406095634286;11523.53905843757;11545;11545.88454115448;11581.305121692725;10249.436281004468;10780.029797318279;12141.575044873387;12243.510259589517;12371.13402061865;5546.861328466821;5569.944300556943;5572.749226284827;5577.358603760619;5587.552995760329;826.0541679776622;922.8569571716395;985.7092157813462;989.5349185882624;1004.8542961270575;20185.394438166877;23700.88149559241;23998;24057.398565035663;24313.270601881974;1090.6673464593216;1095.397531357766;1118.2731224704007;1120.3781901044836;1125.967628430674;11567;12340.691482713004;12354.691132721753;12370.13409061357;12379.133460657848;280594;282102;282577;282637;283046;51748.22377664338;51897.740511297205;51911.221331680055;51936.220956685676;52178.17376391808;1284.8072789081712;1479.9260036998107;1537.385045981594;1537.9692406151814;1556.8053993250844;23753.52492950166;23788.286351409486;23813.166539171045;23946;23946.76053239445;38223.80888095542;38266;38282.80858595689;38342;38364.424533631456;206531;253064;253329;254203;254500;32689.836550817094;33787.83106084454;33857.66142338545;33862.492062619574;33863.661363386054;36172;36369.81815090908;36385.09037273983;36447.81776091208;36449.90650280496;22634.886825565765;25094.49811003806;28791.280217994718;30165;30297.24256893507;28865.567016495188;28922.42155156927;29780.95766648157;29856.402871942875;29908.700912990593;36125.27749445049;36152.63847361493;36229;36298.27403451969;36364;27738;28554.85780568754;29239.7076029237;30112.24719382033;30420.93526726554;21903.67144492866;23228;23238.3028509145;23448.413789655395;23541.411464713517 07:27:16 INFO - PID 2352 | |2;jquery.html;436.15386150867295;439.5011661763897;441.6886095302812;450.2121287746444;461.22053729197677;18799.060046997645;20531.794682053176;21134.471638209052;21429.785702142974;21458.356249312506;20987;21443.142274309048;21578.568428631417;21678.674819877713;23329.416764580896;6012.7294271757655;6214.8135555933395;6232.470240029603;6233.28317243516;6238.095476155955;5995.580309378345;6229.813105606839;6299.685015749217;6300.716467758962;6313.40022697843;5967.462928336449;6266.780662676807;6284.591501552384;6285.497160227171;6287.497000239992;6183.876322473548;6284.12022316876;6292.433680968735;6296.8740625187465;6299.086632438294;5465.344158700981;5524.861878453031;5597.6641401516035;5610.4670056344585;5611.0741727614895;27183;27196.728032719817;27700.168994930184;28071.57892631612;28373.574396384072;2167.198136689435;2233.363491404958;2238.1159442020476;2240;2240.361496973355;17463.65072698539;17666.734998975026;17739.11304434786;18107.366242181593;18307.63384732311;2115.079940226007;2123.288698286076;2167.5448155887125;2169.717936668223;2171.2834764527825;150131;152764;154892.22553887157;155538;157872;11788.88211117895;12437.315947622968;12451.688707782378;12462.5014999399;12467.625971220878;16666.749998750027;16739.748903766453;16774.58063548421;16795.16024198785;16816.495505134866;7452.105747310357;7650.655720492591;7688.154303026663;7746.806329841799;7787.415943804237;6812.727490900308;6833.248342682301;6838.829029274308;6975.895361569581;6999.545029573163;7650.579218142944;7806.336461400844;7817.843643127106;7818.335441487424;7823.569703666353;2097.339338108491;2108.3042595943302;2112.1445814445174;2113.2075471698113;2260.423591984066;942.236788201559;950.9762255943518;953.68051702679;954.3939598355095;978.7797745507346;20041.799582004285;20402.795972040385;20464.38606841797;20539.075741591663;20810.895945520177;935.8081593273363;966.8211380894417;998.3161534348994;1003.7390278527636;1007.969760907174;9354.438733676001;10106;10710.89289107099;10844.024037836632;10925.726856828644;532780;545744;547823;556129;560004;131612;136806;137954.31022845022;138308.61691382958;138530;1187.827764974074;1201.66353421044;1232.2052276281747;1238.467458992642;1243.6269119264184;17378.76723906508;21560.59856109348;22385;22523.436914076625;22597.2090976815;58362.4163758374;58367.70816145892;58706.706466467396;59436.70281648564;59568;79634;81020;81513.77729333946;81690.366192677;81754.59122704348;7189.978873520075;7917.327027202752;8430.45202061864;8667.609957551798;9191.77020574491;10130.746731331481;13788.586342409744;13856.653583660489;14273;14371.568852934428;10434.634787782392;11566.958973692408;11674.182807203415;12002.63992080239;12073.27560346382;10764.138868890626;10986.670399888017;11154.996050355507;11168.385738784445;11271;9605.519724013631;11716.17986740954;11732.882671173178;12076.879231207575;12148.27110373345;8840.911590884267;8913;8965.237954773916;8997.37018408705;9011.369204155646;11569.6529104127;11744.86658069629;11910.166288359731;11915.987141093105;11999.280043197436 07:27:16 INFO - PID 2352 | |3;mootools.html;1160.646002969094;1243.179501528991;1337.2711872029743;1389.5761792653236;1412.7810189420636;9683.370580912237;10182.74543136422;11558;11786.646400607973;11823.881761182385;11375.886241137587;11478.311301321926;11484.483198256077;11488.942555287213;11509.654710358702;2461.0401943242196;2500.499900019994;2505.5615267328235;2507;2507.862067586282;2033.4408037789651;2097.1716172112083;2175.2930297653247;2544.73280305568;2549.821512494126;2366.7751563601432;2388.940276493084;2394.449276666368;2401.831871768968;2403.194929698553;2431.6474111253856;2474.34429876083;2474.764897334768;2476.1209770531473;2479.1323036937106;2434.732179460258;2449.448874003353;2450;2451.460678650712;2461.9138330158357;11377.601783937605;11613.30320180792;11623.476943537562;11639.709007274801;11659.533618655243;6489.1888513935755;6734.7642832501115;6740;6746.359095885883;6758.966205168992;3609.043603445089;3973.5033120859894;4085.285075111873;4190.8533201337805;4216.966843123454;1229.551213806954;1265.5633806336798;1281.653953432568;1282.5254655777328;1282.7947528395412;16721.331146754113;16725.247363868777;16735.330586776516;16755.581110472212;16786.496405107868;5729.54163666914;5798.159266906275;5863.589548731547;6019.097135429633;6172.382761723792;13968.161910285415;13968.301584920713;13968.58094257174;13997.370118344495;14001.5099471518;6707.865842683119;6710.463162946952;6714.932850671431;6717.1267735194115;6719;5266.394364648115;6102.084687296941;6105.084237364431;6120.418560236771;6168.475679567197;3361.562996810399;4212.473440819897;4217.261979153636;4217.34631132175;4217.418468074472;1320.2870449957109;1441.67562298482;1482.2588705647177;1482.4737218287569;1485.5394827603477;763.2443880558208;775.685847231872;789.3448437796615;805.452292441134;825.4263287015586;6442.645654489048;6706.664666766642;6898.517103802686;6935.479839012094;6937.826554336081;732.4653003307616;896.3591032411857;917.5137177296044;940.7507010642186;942.8350038743192;3435.811030393302;3811.6950643948417;3818.427235914635;3911.1786524830104;3944.723869329119;12355.505779768708;13688;14217.004809663431;14606.269686515845;15373.615659608598;11999.460024298927;13853.51512697071;14143.29283535819;14145.222012789396;14178.85821141796;7514.774556763306;7619.435167311019;8220.219079187467;8729.345299102466;8774.956125219333;5811.912821307599;6954.269801670954;7159.749408770668;7161.391281740902;7207.495475316678;13436.3627299465;13558.86441135576;13807;13843.508168529359;13875.236861972284;11405.600803971822;13673.384697688827;13871.306434678427;14067.437302507786;14153.504627337994;8770.561471926505;8859.911400885909;8861.98087219978;9024.774380640274;9481.857772133286;10841.349519028883;11057.391843448688;11064.502097405475;11072.778544428906;11093.001629853352;9042.367034307536;9075.319351048829;9179.495127768037;9267.953660231655;9419.199368053793;7448.962755186406;8962.283017358464;9003.369764116449;9092.136247056518;9159.16066019536;7492.51298665585;7567.735129270449;8220.054693710299;8304;8344.624491897757;6014.548908831767;6033.0340184759525;6143.662098584621;6200.875982480416;6218.22272215973;6083.543734219863;6257.812265632038;6283.874322513433;6357.474240841377;6404.935950640434 07:27:16 INFO - PID 2352 | |4;prototype.html;397.06491213192936;398.9780562069085;403.3445650817422;403.75572778469035;406.9430279760836;5126.461721519243;5359.67841929484;5689.089745640693;5957.9445091443495;5973.701314934257;5006.799728010875;5577.358603760569;5863.384344643815;5872.17789509469;5887.646741195521;4061.24866899623;4102.774347410891;4223.978880105595;4494.842680506183;4496.55034496551;4520.29935360018;4525.230710779176;4528.20756367636;4528.320751887227;4551.590356867881;4351.58573463624;4457.264551349023;4460.241758900978;4496.055828276066;4513.909721805562;3805.6004119567324;3808.7905165215902;4251.3622956556455;4437.955620443802;4452.243118669818;3507.2810073934784;3798.3542797724176;4013.678905687538;4021.055052062763;4029.9395509067094;4848.757562121879;5035.597152227813;5044.596432285409;5061.519155680205;5197.882455272134;4565.474970378383;5247.586110389226;5396.271503347037;5399.163129714901;5399.676019438807;6177.783777567808;6237.438630523229;6265.71804268809;6283.3088360280335;6287.598680923372;4411.536788637179;4496.279750750814;4541;4544.500104988449;4549.9990002199465;5263.4473380295285;6091.634501929854;6330.65181415022;6616.86766264672;6627.900581491282;4508.504064552896;4653.162430762495;4744.644151688568;4755.5719985201495;4760.904781904412;4134.710570260053;4805.674892596691;4839.879003024953;4860;4860.513948605111;4375.737455752601;4468.128714900628;5358.758855851496;5393.813361060639;5440.211169380497;6299.275583307978;6314.842128946813;6322.178116844781;6324.525660575383;6329.525285603506;1397.6715471864104;1471.9264036798118;1489.2330449818353;1571.6149543361948;1674.6315810521667;960.2989817433313;960.8991055939166;977.3793641037992;985.6353149334792;994.5773046455228;5005.9749701251985;5284.617844579472;5971.58198926071;5971.701414929236;5973.581849270509;5825.067989121805;5953.672548009901;6427.164468619049;6488.935110648928;6505.544611877218;5804.912926306109;5885.852853678607;5939.673317967553;5967.492763115184;5987.970060149759;2973.3012742005612;3355.798652080883;3405.4551271796395;3405.7956522608724;3421.6749408806622;5769.826905192851;6059.757609695651;6675.496688741722;6697.631630260285;6724.66376681164;5537.889242215133;6647.534672572873;6661.433778128913;6671.833204169935;6672;5711.600187986801;5791.015527360275;5915.816836632691;6365.99471166581;6710.261871194165;5323;6431.099646049463;6443.226812782496;6451.3226111257645;6453.806385808433;5561.360443549043;6054.939450605438;6342.399616157353;6353.77761778354;6374.23509178883;4917.704937703749;6056.788012419544;6381.329960354282;6697.899531507129;6720.092787473628;3930.2336044471053;3950.683945284313;4235.724677895927;4246.3842742802735;4268.125034367885;6363.695442434382;6453.45145662624;6474.384933431316;6528.21661400635;6551.50863685216;5223.138182199895;5871.882562348815;6133.834571431414;6260.843478913063;6274.905876411949;4979.0788704089855;5283.89432211346;5930.644161350333;6072.392760723892;6078.179445774941;4558.020025694492;5304.310439642822;5766.452187042224;5928.992071347795;6209.59637623553;5447.972760136333;6259.530535209969;6273.964795808641;6327.272363678236;6351.587146835441;5596.496315331639;5964.463198312173;6030.547708921761;6089.604175728564;6153.169322141633 07:27:16 INFO - PID 2352 | |5;yui.html;761.7486229544251;830.9958450207748;841.6423020216406;861.7587075618825;867.0462491259615;16160.83839161611;16285.83714162858;16703;16709.83290167098;16757.413490527848;15559.988600740971;15571.377144914219;15765.369385224605;15776.0534367938;15790.842091579081;952.5237381309346;958.5734348215047;959.7792507723228;960.0639376607821;990.7770751580908;995.3579940938091;1012.2205901455875;1021.2748948246754;1027.9126274266696;1042.1298215989657;1079.0180935348835;1080.18446073215;1081.3403823667556;1083.3012706804107;1083.8103331916923;1071.5927947379985;1078.5739632844982;1078.6925726168045;1080.751427171751;1081.6160263106563;806.7983004248938;809.9838003239961;810.9270165685117;812.9512229266263;813.7233340664144;16080.276387562588;16096.195190240558;16208.108554029524;16904.239309231114;17170.141492925428;16797.91601041999;16824.57938551534;17021.31914723422;17215.913920430317;17270.395536156175;13858.4456621735;13927.651808704763;13953;13960.162390256617;14170.858291417057;3486.4595987621706;3508.1405055761247;3511.7892926424242;3515.2793677296095;3516.261585067139;67802.66098669525;130954.34522827421;133161.33419332939;134250.3287483566;136227.31886340506;10448.477576121164;11111.444427778579;11295.49170287339;11390.25963312382;11395.088392928546;19126.904365478083;24612.384690382885;24752.25743227706;24772.25683229506;25066.99732010699;7790.143084260727;7894.407919406068;7897.486663366978;7901.881471777928;7904.328132108835;3792.943105853414;3871.845126194921;3874.8837534874;3934.2918274710255;3943.152222272225;4149.294619914562;4239.448871646728;4242.7242229255;4243.98144445337;4248.702590818613;810.6433169405443;847.817719190377;856.2678909532385;857.2756021162108;858.6522458404356;655.2955572759303;663.5918909870395;673.1417442760519;674.4031532094034;688.3907741648677;10647.414392208348;11682.532698692126;11964.607782890389;11975.341356225317;12142.575009874789;654.3881470824793;656.2584279763931;658.2200092889941;660.1945626335862;670.9630970296583;5430.348358196962;5570.192322113352;5623.606347555714;5661.179129026268;5672.659640421588;104433.43349849759;106409;106685;107975.46012269889;110334.44832775946;93910;95076;97747;98059.01940980641;98429;61519.077213841825;74868.62565687245;76413;77969;79149.81275280875;10676.83984740245;10967.616133435291;11441.362029178035;11988.400579971141;12748.49006039748;31656.5251521232;39775.80112099421;40802.591974081064;41251.38122928098;41700.58299416967;73760.52478950498;75300.62349688217;75648;75649.62175189088;77058.22941770735;15843.445479408627;15956.920215398848;16002.19989000522;16106;16552.924059936067;17486;18075.36736214226;18187.363442279457;18262.36081737133;18461.630767384308;16044.518664440086;16488.505344839676;16501;16584.336626534805;16605.667886641957;15975.68048639044;16194.352225910832;16556.586085347964;16645.667086657955;16693.666126677643;15732.685346292781;15882.364705411654;16027.198640068184;16307.836921630631;16446.342146314015;11235.651856700937;11241.943790280997;11313.490892910004;11402.372869491926;11480.425978700865;13166.210027398387;13555.59333220005;13565.525206618116;13585.52450664222;13654.112482688593 07:27:16 INFO - PID 2352 | __end_tp_report 07:27:16 INFO - PID 2352 | __start_cc_report 07:27:16 INFO - PID 2352 | _x_x_mozilla_cycle_collect,1865 07:27:16 INFO - PID 2352 | __end_cc_report 07:27:16 INFO - PID 2352 | __startTimestamp1494426436228__endTimestamp 07:27:16 INFO - PID 2352 | 07:27:16 INFO - PID 2352 | ------- Summary: start ------- 07:27:16 INFO - PID 2352 | Number of tests: 6 07:27:16 INFO - PID 2352 | 07:27:16 INFO - PID 2352 | [#0] dojo.html Cycles:165 Average:6013.36 Median:6293.21 stddev:720.85 (11.5%) stddev-sans-first:689.09 07:27:16 INFO - PID 2352 | Values: 3225.4 3516.1 3531.5 3542.1 3583.9 5987.0 6135.9 6199.0 6205.6 6211.7 6009.8 6041.9 6055.6 6067.3 6074.0 5210.8 5257.4 5264.6 5268.2 5341.5 4087.4 5179.8 5418.9 5467.8 5489.9 5404.4 5408.4 5429.6 5432.5 5443.4 5186.8 5307.8 5447.9 5463.4 5508.0 4336.5 5333.8 5353.6 5369.7 5380.2 6007.7 6129.7 6133.7 6145.5 6155.0 6293.2 6363.2 6495.3 6505.0 6512.0 6393.0 6465.4 6553.0 6565.4 6687.1 6237.3 6243.1 6243.7 6254.9 6257.2 6711.9 6770.0 6774.2 6775.7 6795.9 6289.3 6297.5 6379.2 6393.1 6415.0 6432.6 6433.6 6435.4 6445.3 6452.1 6348.4 6369.4 6388.3 6405.7 6456.8 6463.2 6466.0 6476.7 6489.6 6505.9 5228.7 5234.4 5243.8 5245.8 5263.7 4514.0 4548.7 4570.9 4654.8 4687.0 6214.4 6236.9 6250.6 6258.2 6262.9 6589.9 6590.6 6600.8 6611.8 6629.0 5021.3 6150.5 6273.9 6280.7 6314.0 5711.1 5720.5 5730.0 5738.7 5740.7 6632.3 6632.8 6632.9 6647.5 6647.6 6375.1 6428.7 6432.6 6433.4 6453.0 6626.8 6726.0 6822.1 6826.2 6834.6 6454.0 6475.9 6491.5 6494.6 6496.2 6415.9 6468.9 6470.2 6546.3 6609.3 6209.9 6276.3 6380.4 6392.7 6412.1 5281.8 6329.7 6334.1 6399.8 6400.1 6149.4 6276.8 6283.6 6307.5 6312.8 6353.6 6361.4 6372.7 6376.8 6379.0 6136.5 6315.2 6317.9 6329.7 6331.0 07:27:16 INFO - PID 2352 | 07:27:16 INFO - PID 2352 | [#1] ext.html Cycles:180 Average:41312.19 Median:33822.75 stddev:69420.42 (205.2%) stddev-sans-first:69548.13 07:27:16 INFO - PID 2352 | Values: 680.9 753.3 801.1 1017.5 1113.4 26072.1 31421.9 35164.8 36293.5 36873.0 38415.0 38629.0 38737.0 38776.0 38797.2 6005.6 8196.6 8338.7 8350.0 8362.1 5961.3 6275.4 8342.9 8345.9 8354.5 8401.8 8430.2 8440.8 8442.6 8537.3 8360.8 8390.6 8412.0 8412.4 8412.5 5920.8 5950.7 8030.2 8172.6 8189.6 36188.5 36369.5 36467.8 36515.3 36629.8 3458.1 3495.8 3496.5 3498.2 3498.8 29695.7 29801.0 29804.6 29844.7 29845.0 3071.2 3129.6 3157.0 3176.5 3181.6 267327.0 267555.0 267828.0 267834.0 268130.0 39067.4 48291.0 48301.0 48307.3 48391.5 50520.5 50539.5 50653.7 50677.7 50692.7 14066.7 14145.8 14155.6 14164.4 14179.6 9898.4 11523.5 11545.0 11545.9 11581.3 10249.4 10780.0 12141.6 12243.5 12371.1 5546.9 5569.9 5572.7 5577.4 5587.6 826.1 922.9 985.7 989.5 1004.9 20185.4 23700.9 23998.0 24057.4 24313.3 1090.7 1095.4 1118.3 1120.4 1126.0 11567.0 12340.7 12354.7 12370.1 12379.1 280594.0 282102.0 282577.0 282637.0 283046.0 51748.2 51897.7 51911.2 51936.2 52178.2 1284.8 1479.9 1537.4 1538.0 1556.8 23753.5 23788.3 23813.2 23946.0 23946.8 38223.8 38266.0 38282.8 38342.0 38364.4 206531.0 253064.0 253329.0 254203.0 254500.0 32689.8 33787.8 33857.7 33862.5 33863.7 36172.0 36369.8 36385.1 36447.8 36449.9 22634.9 25094.5 28791.3 30165.0 30297.2 28865.6 28922.4 29781.0 29856.4 29908.7 36125.3 36152.6 36229.0 36298.3 36364.0 27738.0 28554.9 29239.7 30112.2 30420.9 21903.7 23228.0 23238.3 23448.4 23541.4 07:27:16 INFO - PID 2352 | 07:27:16 INFO - PID 2352 | [#2] jquery.html Cycles:180 Average:35776.91 Median:12381.90 stddev:93357.02 (754.0%) stddev-sans-first:93581.20 07:27:16 INFO - PID 2352 | Values: 436.2 439.5 441.7 450.2 461.2 18799.1 20531.8 21134.5 21429.8 21458.4 20987.0 21443.1 21578.6 21678.7 23329.4 6012.7 6214.8 6232.5 6233.3 6238.1 5995.6 6229.8 6299.7 6300.7 6313.4 5967.5 6266.8 6284.6 6285.5 6287.5 6183.9 6284.1 6292.4 6296.9 6299.1 5465.3 5524.9 5597.7 5610.5 5611.1 27183.0 27196.7 27700.2 28071.6 28373.6 2167.2 2233.4 2238.1 2240.0 2240.4 17463.7 17666.7 17739.1 18107.4 18307.6 2115.1 2123.3 2167.5 2169.7 2171.3 150131.0 152764.0 154892.2 155538.0 157872.0 11788.9 12437.3 12451.7 12462.5 12467.6 16666.7 16739.7 16774.6 16795.2 16816.5 7452.1 7650.7 7688.2 7746.8 7787.4 6812.7 6833.2 6838.8 6975.9 6999.5 7650.6 7806.3 7817.8 7818.3 7823.6 2097.3 2108.3 2112.1 2113.2 2260.4 942.2 951.0 953.7 954.4 978.8 20041.8 20402.8 20464.4 20539.1 20810.9 935.8 966.8 998.3 1003.7 1008.0 9354.4 10106.0 10710.9 10844.0 10925.7 532780.0 545744.0 547823.0 556129.0 560004.0 131612.0 136806.0 137954.3 138308.6 138530.0 1187.8 1201.7 1232.2 1238.5 1243.6 17378.8 21560.6 22385.0 22523.4 22597.2 58362.4 58367.7 58706.7 59436.7 59568.0 79634.0 81020.0 81513.8 81690.4 81754.6 7190.0 7917.3 8430.5 8667.6 9191.8 10130.7 13788.6 13856.7 14273.0 14371.6 10434.6 11567.0 11674.2 12002.6 12073.3 10764.1 10986.7 11155.0 11168.4 11271.0 9605.5 11716.2 11732.9 12076.9 12148.3 8840.9 8913.0 8965.2 8997.4 9011.4 11569.7 11744.9 11910.2 11916.0 11999.3 07:27:16 INFO - PID 2352 | 07:27:16 INFO - PID 2352 | [#3] mootools.html Cycles:180 Average:7074.79 Median:3522.43 stddev:4501.81 (127.8%) stddev-sans-first:4492.50 07:27:16 INFO - PID 2352 | Values: 1160.6 1243.2 1337.3 1389.6 1412.8 9683.4 10182.7 11558.0 11786.6 11823.9 11375.9 11478.3 11484.5 11488.9 11509.7 2461.0 2500.5 2505.6 2507.0 2507.9 2033.4 2097.2 2175.3 2544.7 2549.8 2366.8 2388.9 2394.4 2401.8 2403.2 2431.6 2474.3 2474.8 2476.1 2479.1 2434.7 2449.4 2450.0 2451.5 2461.9 11377.6 11613.3 11623.5 11639.7 11659.5 6489.2 6734.8 6740.0 6746.4 6759.0 3609.0 3973.5 4085.3 4190.9 4217.0 1229.6 1265.6 1281.7 1282.5 1282.8 16721.3 16725.2 16735.3 16755.6 16786.5 5729.5 5798.2 5863.6 6019.1 6172.4 13968.2 13968.3 13968.6 13997.4 14001.5 6707.9 6710.5 6714.9 6717.1 6719.0 5266.4 6102.1 6105.1 6120.4 6168.5 3361.6 4212.5 4217.3 4217.3 4217.4 1320.3 1441.7 1482.3 1482.5 1485.5 763.2 775.7 789.3 805.5 825.4 6442.6 6706.7 6898.5 6935.5 6937.8 732.5 896.4 917.5 940.8 942.8 3435.8 3811.7 3818.4 3911.2 3944.7 12355.5 13688.0 14217.0 14606.3 15373.6 11999.5 13853.5 14143.3 14145.2 14178.9 7514.8 7619.4 8220.2 8729.3 8775.0 5811.9 6954.3 7159.7 7161.4 7207.5 13436.4 13558.9 13807.0 13843.5 13875.2 11405.6 13673.4 13871.3 14067.4 14153.5 8770.6 8859.9 8862.0 9024.8 9481.9 10841.3 11057.4 11064.5 11072.8 11093.0 9042.4 9075.3 9179.5 9268.0 9419.2 7449.0 8962.3 9003.4 9092.1 9159.2 7492.5 7567.7 8220.1 8304.0 8344.6 6014.5 6033.0 6143.7 6200.9 6218.2 6083.5 6257.8 6283.9 6357.5 6404.9 07:27:16 INFO - PID 2352 | 07:27:16 INFO - PID 2352 | [#4] prototype.html Cycles:180 Average:5049.02 Median:5569.36 stddev:1528.37 (27.4%) stddev-sans-first:1492.24 07:27:16 INFO - PID 2352 | Values: 397.1 399.0 403.3 403.8 406.9 5126.5 5359.7 5689.1 5957.9 5973.7 5006.8 5577.4 5863.4 5872.2 5887.6 4061.2 4102.8 4224.0 4494.8 4496.6 4520.3 4525.2 4528.2 4528.3 4551.6 4351.6 4457.3 4460.2 4496.1 4513.9 3805.6 3808.8 4251.4 4438.0 4452.2 3507.3 3798.4 4013.7 4021.1 4029.9 4848.8 5035.6 5044.6 5061.5 5197.9 4565.5 5247.6 5396.3 5399.2 5399.7 6177.8 6237.4 6265.7 6283.3 6287.6 4411.5 4496.3 4541.0 4544.5 4550.0 5263.4 6091.6 6330.7 6616.9 6627.9 4508.5 4653.2 4744.6 4755.6 4760.9 4134.7 4805.7 4839.9 4860.0 4860.5 4375.7 4468.1 5358.8 5393.8 5440.2 6299.3 6314.8 6322.2 6324.5 6329.5 1397.7 1471.9 1489.2 1571.6 1674.6 960.3 960.9 977.4 985.6 994.6 5006.0 5284.6 5971.6 5971.7 5973.6 5825.1 5953.7 6427.2 6488.9 6505.5 5804.9 5885.9 5939.7 5967.5 5988.0 2973.3 3355.8 3405.5 3405.8 3421.7 5769.8 6059.8 6675.5 6697.6 6724.7 5537.9 6647.5 6661.4 6671.8 6672.0 5711.6 5791.0 5915.8 6366.0 6710.3 5323.0 6431.1 6443.2 6451.3 6453.8 5561.4 6054.9 6342.4 6353.8 6374.2 4917.7 6056.8 6381.3 6697.9 6720.1 3930.2 3950.7 4235.7 4246.4 4268.1 6363.7 6453.5 6474.4 6528.2 6551.5 5223.1 5871.9 6133.8 6260.8 6274.9 4979.1 5283.9 5930.6 6072.4 6078.2 4558.0 5304.3 5766.5 5929.0 6209.6 5448.0 6259.5 6274.0 6327.3 6351.6 5596.5 5964.5 6030.5 6089.6 6153.2 07:27:16 INFO - PID 2352 | 07:27:16 INFO - PID 2352 | [#5] yui.html Cycles:180 Average:21987.74 Median:17193.03 stddev:31476.47 (183.1%) stddev-sans-first:31524.41 07:27:16 INFO - PID 2352 | Values: 761.7 831.0 841.6 861.8 867.0 16160.8 16285.8 16703.0 16709.8 16757.4 15560.0 15571.4 15765.4 15776.1 15790.8 952.5 958.6 959.8 960.1 990.8 995.4 1012.2 1021.3 1027.9 1042.1 1079.0 1080.2 1081.3 1083.3 1083.8 1071.6 1078.6 1078.7 1080.8 1081.6 806.8 810.0 810.9 813.0 813.7 16080.3 16096.2 16208.1 16904.2 17170.1 16797.9 16824.6 17021.3 17215.9 17270.4 13858.4 13927.7 13953.0 13960.2 14170.9 3486.5 3508.1 3511.8 3515.3 3516.3 67802.7 130954.3 133161.3 134250.3 136227.3 10448.5 11111.4 11295.5 11390.3 11395.1 19126.9 24612.4 24752.3 24772.3 25067.0 7790.1 7894.4 7897.5 7901.9 7904.3 3792.9 3871.8 3874.9 3934.3 3943.2 4149.3 4239.4 4242.7 4244.0 4248.7 810.6 847.8 856.3 857.3 858.7 655.3 663.6 673.1 674.4 688.4 10647.4 11682.5 11964.6 11975.3 12142.6 654.4 656.3 658.2 660.2 671.0 5430.3 5570.2 5623.6 5661.2 5672.7 104433.4 106409.0 106685.0 107975.5 110334.4 93910.0 95076.0 97747.0 98059.0 98429.0 61519.1 74868.6 76413.0 77969.0 79149.8 10676.8 10967.6 11441.4 11988.4 12748.5 31656.5 39775.8 40802.6 41251.4 41700.6 73760.5 75300.6 75648.0 75649.6 77058.2 15843.4 15956.9 16002.2 16106.0 16552.9 17486.0 18075.4 18187.4 18262.4 18461.6 16044.5 16488.5 16501.0 16584.3 16605.7 15975.7 16194.4 16556.6 16645.7 16693.7 15732.7 15882.4 16027.2 16307.8 16446.3 11235.7 11241.9 11313.5 11402.4 11480.4 13166.2 13555.6 13565.5 13585.5 13654.1 07:27:16 INFO - PID 2352 | -------- Summary: end -------- 07:27:16 INFO - PID 2352 | 07:27:16 INFO - TEST-INFO | 2352: exit 0 07:27:16 INFO - TEST-OK | dromaeo_css | took 1119271ms 07:27:16 INFO - TEST-START | kraken 07:27:16 INFO - operating with platform_type : mac_ 07:27:16 INFO - Initialising browser for kraken test... 07:27:16 INFO - TEST-INFO | started process 2357 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/tmpXoP1cn/profile http://localhost:55003/getInfo.html) 07:27:19 INFO - PID 2357 | __metrics Screen width/height:1600/1200 07:27:19 INFO - PID 2357 | colorDepth:24 07:27:19 INFO - PID 2357 | Browser inner width/height: 1024/691 07:27:19 INFO - PID 2357 | __metrics 07:27:19 INFO - PID 2357 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 07:27:19 INFO - PID 2357 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 334: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:27:20 INFO - TEST-INFO | 2357: exit 0 07:27:20 INFO - Browser initialized. 07:27:20 INFO - Running cycle 1/1 for kraken test... 07:27:20 INFO - TEST-INFO | started process 2358 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/tmpXoP1cn/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:27:32 INFO - PID 2358 | RSS: Main: 233672704 07:27:32 INFO - PID 2358 | 07:27:34 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55003/tests/kraken/driver.html?testName=audio-beat-detection) 07:27:35 INFO - PID 2358 | RSS: Main: 303665152 07:27:35 INFO - PID 2358 | 07:27:38 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55003/tests/kraken/driver.html?testName=audio-dft) 07:27:39 INFO - PID 2358 | RSS: Main: 286093312 07:27:39 INFO - PID 2358 | 07:27:42 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55003/tests/kraken/driver.html?testName=audio-fft) 07:27:42 INFO - PID 2358 | RSS: Main: 376602624 07:27:42 INFO - PID 2358 | 07:27:44 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55003/tests/kraken/driver.html?testName=audio-oscillator) 07:27:45 INFO - PID 2358 | RSS: Main: 282456064 07:27:45 INFO - PID 2358 | 07:27:47 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55003/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:27:48 INFO - PID 2358 | RSS: Main: 284725248 07:27:48 INFO - PID 2358 | 07:27:50 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55003/tests/kraken/driver.html?testName=imaging-darkroom) 07:27:51 INFO - PID 2358 | RSS: Main: 348966912 07:27:51 INFO - PID 2358 | 07:27:54 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55003/tests/kraken/driver.html?testName=imaging-desaturate) 07:27:55 INFO - PID 2358 | RSS: Main: 367620096 07:27:55 INFO - PID 2358 | 07:27:57 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55003/tests/kraken/driver.html?testName=json-parse-financial) 07:27:58 INFO - PID 2358 | RSS: Main: 378781696 07:27:58 INFO - PID 2358 | 07:27:59 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55003/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:28:00 INFO - PID 2358 | RSS: Main: 323342336 07:28:00 INFO - PID 2358 | 07:28:02 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55003/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:28:03 INFO - PID 2358 | RSS: Main: 327032832 07:28:03 INFO - PID 2358 | 07:28:05 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55003/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:28:05 INFO - PID 2358 | RSS: Main: 329117696 07:28:05 INFO - PID 2358 | 07:28:08 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55003/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:28:09 INFO - PID 2358 | RSS: Main: 348532736 07:28:09 INFO - PID 2358 | 07:28:12 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55003/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:28:13 INFO - PID 2358 | RSS: Main: 341278720 07:28:13 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | Cycle 1(1): loaded http://localhost:55003/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55003/tests/kraken/driver.html?testName=ai-astar) 07:28:15 INFO - PID 2358 | RSS: Main: 384065536 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | __start_tp_report 07:28:15 INFO - PID 2358 | _x_x_mozilla_page_load 07:28:15 INFO - PID 2358 | _x_x_mozilla_page_load_details 07:28:15 INFO - PID 2358 | |i|pagename|runs| 07:28:15 INFO - PID 2358 | |0;ai-astar;110;110;111;111;111;111;110;111;111;112 07:28:15 INFO - PID 2358 | |1;audio-beat-detection;141;114;102;161;106;110;108;107;135;107 07:28:15 INFO - PID 2358 | |2;audio-dft;187;186;183;185;187;187;183;187;186;183 07:28:15 INFO - PID 2358 | |3;audio-fft;82;56;58;89;57;58;57;57;88;47 07:28:15 INFO - PID 2358 | |4;audio-oscillator;89;70;84;68;69;72;89;70;67;90 07:28:15 INFO - PID 2358 | |5;imaging-gaussian-blur;87;86;87;86;88;91;87;88;88;87 07:28:15 INFO - PID 2358 | |6;imaging-darkroom;95;94;94;94;94;93;94;94;95;94 07:28:15 INFO - PID 2358 | |7;imaging-desaturate;84;83;84;85;83;85;83;84;84;85 07:28:15 INFO - PID 2358 | |8;json-parse-financial;49;46;47;46;46;49;48;47;47;49 07:28:15 INFO - PID 2358 | |9;json-stringify-tinderbox;53;62;64;98;91;74;75;49;53;62 07:28:15 INFO - PID 2358 | |10;stanford-crypto-aes;83;83;82;82;82;82;83;81;80;80 07:28:15 INFO - PID 2358 | |11;stanford-crypto-ccm;137;152;141;133;133;137;136;139;174;153 07:28:15 INFO - PID 2358 | |12;stanford-crypto-pbkdf2;185;187;182;186;181;181;189;231;203;186 07:28:15 INFO - PID 2358 | |13;stanford-crypto-sha256-iterative;57;93;98;68;67;68;69;67;67;68 07:28:15 INFO - PID 2358 | __end_tp_report 07:28:15 INFO - PID 2358 | __start_cc_report 07:28:15 INFO - PID 2358 | _x_x_mozilla_cycle_collect,2203 07:28:15 INFO - PID 2358 | __end_cc_report 07:28:15 INFO - PID 2358 | __startTimestamp1494426495324__endTimestamp 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | ------- Summary: start ------- 07:28:15 INFO - PID 2358 | Number of tests: 14 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#0] ai-astar Cycles:10 Average:110.80 Median:111.00 stddev:0.63 (0.6%) stddev-sans-first:0.60 07:28:15 INFO - PID 2358 | Values: 110.0 110.0 111.0 111.0 111.0 111.0 110.0 111.0 111.0 112.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#1] audio-beat-detection Cycles:10 Average:119.10 Median:112.00 stddev:19.66 (17.5%) stddev-sans-first:19.18 07:28:15 INFO - PID 2358 | Values: 141.0 114.0 102.0 161.0 106.0 110.0 108.0 107.0 135.0 107.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#2] audio-dft Cycles:10 Average:185.40 Median:186.50 stddev:1.78 (1.0%) stddev-sans-first:1.79 07:28:15 INFO - PID 2358 | Values: 187.0 186.0 183.0 185.0 187.0 187.0 183.0 187.0 186.0 183.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#3] audio-fft Cycles:10 Average:64.90 Median:58.00 stddev:15.23 (26.3%) stddev-sans-first:14.85 07:28:15 INFO - PID 2358 | Values: 82.0 56.0 58.0 89.0 57.0 58.0 57.0 57.0 88.0 47.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#4] audio-oscillator Cycles:10 Average:76.80 Median:78.00 stddev:9.85 (12.6%) stddev-sans-first:9.41 07:28:15 INFO - PID 2358 | Values: 89.0 70.0 84.0 68.0 69.0 72.0 89.0 70.0 67.0 90.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#5] imaging-gaussian-blur Cycles:10 Average:87.50 Median:87.50 stddev:1.43 (1.6%) stddev-sans-first:1.51 07:28:15 INFO - PID 2358 | Values: 87.0 86.0 87.0 86.0 88.0 91.0 87.0 88.0 88.0 87.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#6] imaging-darkroom Cycles:10 Average:94.10 Median:94.00 stddev:0.57 (0.6%) stddev-sans-first:0.50 07:28:15 INFO - PID 2358 | Values: 95.0 94.0 94.0 94.0 94.0 93.0 94.0 94.0 95.0 94.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#7] imaging-desaturate Cycles:10 Average:84.00 Median:84.00 stddev:0.82 (1.0%) stddev-sans-first:0.87 07:28:15 INFO - PID 2358 | Values: 84.0 83.0 84.0 85.0 83.0 85.0 83.0 84.0 84.0 85.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#8] json-parse-financial Cycles:10 Average:47.40 Median:47.50 stddev:1.26 (2.7%) stddev-sans-first:1.20 07:28:15 INFO - PID 2358 | Values: 49.0 46.0 47.0 46.0 46.0 49.0 48.0 47.0 47.0 49.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#9] json-stringify-tinderbox Cycles:10 Average:68.10 Median:69.00 stddev:16.37 (23.7%) stddev-sans-first:16.43 07:28:15 INFO - PID 2358 | Values: 53.0 62.0 64.0 98.0 91.0 74.0 75.0 49.0 53.0 62.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#10] stanford-crypto-aes Cycles:10 Average:81.80 Median:82.00 stddev:1.14 (1.4%) stddev-sans-first:1.12 07:28:15 INFO - PID 2358 | Values: 83.0 83.0 82.0 82.0 82.0 82.0 83.0 81.0 80.0 80.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#11] stanford-crypto-ccm Cycles:10 Average:143.50 Median:140.00 stddev:12.83 (9.2%) stddev-sans-first:13.39 07:28:15 INFO - PID 2358 | Values: 137.0 152.0 141.0 133.0 133.0 137.0 136.0 139.0 174.0 153.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:191.10 Median:186.50 stddev:15.39 (8.3%) stddev-sans-first:16.16 07:28:15 INFO - PID 2358 | Values: 185.0 187.0 182.0 186.0 181.0 181.0 189.0 231.0 203.0 186.0 07:28:15 INFO - PID 2358 | 07:28:15 INFO - PID 2358 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.20 Median:68.00 stddev:12.80 (18.8%) stddev-sans-first:12.33 07:28:15 INFO - PID 2358 | Values: 57.0 93.0 98.0 68.0 67.0 68.0 69.0 67.0 67.0 68.0 07:28:15 INFO - PID 2358 | -------- Summary: end -------- 07:28:15 INFO - PID 2358 | 07:28:16 INFO - TEST-INFO | 2358: exit 0 07:28:16 INFO - TEST-OK | kraken | took 59317ms 07:28:16 INFO - SUITE-END | took 1178s 07:28:16 INFO - Completed test suite (00:19:38) 07:28:16 INFO - javascript benchmark 07:28:16 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7705.865923717406, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3225.435548778964, 3516.1033936346244, 3531.4879342495324, 3542.0790594445452, 3583.874564390247, 5986.970065149679, 6135.938640613593, 6199.039148931912, 6205.627662340257, 6211.689415529222, 6009.759609615621, 6041.939580604193, 6055.5761096723245, 6067.302260240073, 6073.969630151854, 5210.843674689746, 5257.395399529065, 5264.552513036397, 5268.209768534713, 5341.4925582069645, 4087.386891966214, 5179.834537229131, 5418.9458105418835, 5467.781288748465, 5489.862753431176, 5404.432534583871, 5408.35099788024, 5429.647072940266, 5432.538234250093, 5443.428440013801, 5186.844394668166, 5307.814226502092, 5447.863803404926, 5463.399026107125, 5508.03609368359, 4336.522982471925, 5333.813316533941, 5353.625246232766, 5369.677819330814, 5380.24676545284, 6007.729652165663, 6129.693515324216, 6133.723982420802, 6145.508359331243, 6154.984427569446, 6293.213348331458, 6363.236411630634, 6495.285518592951, 6505.0, 6512.0, 6393.041043843415, 6465.3534646535445, 6553.0, 6565.441937435324, 6687.097241872334, 6237.282712488077, 6243.063540468966, 6243.719032643542, 6254.937450625526, 6257.186565746424, 6711.899321510181, 6770.0, 6774.220964589037, 6775.72897084121, 6795.932040679629, 6289.339619339903, 6297.4962003039645, 6379.170707807955, 6393.1369265148605, 6415.005674120519, 6432.614043157332, 6433.613983160932, 6435.388638079375, 6445.291017988017, 6452.064450654629, 6348.3969022943675, 6369.394907483782, 6388.265349484869, 6405.6797160141805, 6456.806295811133, 6463.192100987377, 6466.0, 6476.740930362733, 6489.643069631121, 6505.902411463831, 5228.660137091077, 5234.371875374979, 5243.8164664236565, 5245.790168393221, 5263.6578622389425, 4513.9617887885315, 4548.658850586219, 4570.862874113782, 4654.813807447664, 4687.015726697364, 6214.378562143749, 6236.906446403307, 6250.593711408744, 6258.186435763321, 6262.906056409158, 6589.86820263592, 6590.637514936724, 6600.834979125464, 6611.834704132339, 6628.96685516579, 5021.297018417425, 6150.477209437158, 6273.905891411632, 6280.748770049238, 6314.0, 5711.086226203787, 5720.542356611461, 5730.025895597675, 5738.655680659173, 5740.655560666373, 6632.336766323329, 6632.83417914556, 6632.90050649231, 6647.534672572873, 6647.60114393138, 6375.075614035846, 6428.710708018244, 6432.614043157426, 6433.388828061326, 6453.032045193258, 6626.801195964129, 6725.9663701681175, 6822.11312529368, 6826.180858297036, 6834.589924604539, 6454.0, 6475.935240647534, 6491.545591808528, 6494.577852439576, 6496.220453545416, 6415.871682566416, 6468.935310646833, 6470.22357317125, 6546.345365463416, 6609.272979972103, 6209.875802484015, 6276.278228003838, 6380.3619638035825, 6392.712327945161, 6412.102305677302, 5281.7887284509725, 6329.651869147241, 6334.081558174131, 6399.776007839703, 6400.103985441949, 6149.41580549847, 6276.811695649138, 6283.59156654816, 6307.526935479949, 6312.779052733316, 6353.5870168438905, 6361.363863613602, 6372.681365931592, 6376.840578985562, 6379.043143528508, 6136.549713441251, 6315.210598675166, 6317.905231421624, 6329.683515824282, 6331.018692102732], "value": 5965.152211872819, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [680.9353111454411, 753.3333000294738, 801.1387758159977, 1017.506509342969, 1113.4488428228028, 26072.08747693831, 31421.900233491804, 35164.82417587908, 36293.455598166016, 36873.0, 38415.03962400941, 38629.0, 38737.03157421066, 38776.0, 38797.22405551887, 6005.609635373687, 8196.631151598178, 8338.66645334189, 8350.039745429292, 8362.121977192399, 5961.314448838374, 6275.372462753734, 8342.916570834304, 8345.916540834605, 8354.45696029756, 8401.789955251137, 8430.241278284953, 8440.83118337636, 8442.57787110645, 8537.274331681814, 8360.832783344329, 8390.580470976487, 8411.95794021032, 8412.411131220817, 8412.537310447922, 5920.822375328747, 5950.702464876739, 8030.156833532512, 8172.6322315495945, 8189.631466584018, 36188.45717314242, 36369.45445818288, 36467.817660911525, 36515.26969460623, 36629.81685091584, 3458.1008937676384, 3495.842687079062, 3496.5454490916018, 3498.2129020970333, 3498.772579782306, 29695.70304296951, 29801.0, 29804.552931706043, 29844.70155298441, 29845.0, 3071.17078388836, 3129.624445066584, 3156.9842150789327, 3176.491761318201, 3181.6341120771176, 267327.0, 267555.0, 267828.0, 267834.0, 268130.0, 39067.41398879019, 48291.0, 48301.033979320215, 48307.27539086917, 48391.5160848387, 50520.49479505158, 50539.49460505348, 50653.746731266845, 50677.74661126671, 50692.746536267085, 14066.71866562663, 14145.787813182811, 14155.575332740034, 14164.36260368286, 14179.574612761633, 9898.406095634286, 11523.53905843757, 11545.0, 11545.88454115448, 11581.305121692725, 10249.436281004468, 10780.029797318279, 12141.575044873387, 12243.510259589517, 12371.13402061865, 5546.861328466821, 5569.944300556943, 5572.749226284827, 5577.358603760619, 5587.552995760329, 826.0541679776622, 922.8569571716395, 985.7092157813462, 989.5349185882624, 1004.8542961270575, 20185.394438166877, 23700.88149559241, 23998.0, 24057.398565035663, 24313.270601881974, 1090.6673464593216, 1095.397531357766, 1118.2731224704007, 1120.3781901044836, 1125.967628430674, 11567.0, 12340.691482713004, 12354.691132721753, 12370.13409061357, 12379.133460657848, 280594.0, 282102.0, 282577.0, 282637.0, 283046.0, 51748.22377664338, 51897.740511297205, 51911.221331680055, 51936.220956685676, 52178.17376391808, 1284.8072789081712, 1479.9260036998107, 1537.385045981594, 1537.9692406151814, 1556.8053993250844, 23753.52492950166, 23788.286351409486, 23813.166539171045, 23946.0, 23946.76053239445, 38223.80888095542, 38266.0, 38282.80858595689, 38342.0, 38364.424533631456, 206531.0, 253064.0, 253329.0, 254203.0, 254500.0, 32689.836550817094, 33787.83106084454, 33857.66142338545, 33862.492062619574, 33863.661363386054, 36172.0, 36369.81815090908, 36385.09037273983, 36447.81776091208, 36449.90650280496, 22634.886825565765, 25094.49811003806, 28791.280217994718, 30165.0, 30297.24256893507, 28865.567016495188, 28922.42155156927, 29780.95766648157, 29856.402871942875, 29908.700912990593, 36125.27749445049, 36152.63847361493, 36229.0, 36298.27403451969, 36364.0, 27738.0, 28554.85780568754, 29239.7076029237, 30112.24719382033, 30420.93526726554, 21903.67144492866, 23228.0, 23238.3028509145, 23448.413789655395, 23541.411464713517], "value": 16632.906689066713, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [436.15386150867295, 439.5011661763897, 441.6886095302812, 450.2121287746444, 461.22053729197677, 18799.060046997645, 20531.794682053176, 21134.471638209052, 21429.785702142974, 21458.356249312506, 20987.0, 21443.142274309048, 21578.568428631417, 21678.674819877713, 23329.416764580896, 6012.7294271757655, 6214.8135555933395, 6232.470240029603, 6233.28317243516, 6238.095476155955, 5995.580309378345, 6229.813105606839, 6299.685015749217, 6300.716467758962, 6313.40022697843, 5967.462928336449, 6266.780662676807, 6284.591501552384, 6285.497160227171, 6287.497000239992, 6183.876322473548, 6284.12022316876, 6292.433680968735, 6296.8740625187465, 6299.086632438294, 5465.344158700981, 5524.861878453031, 5597.6641401516035, 5610.4670056344585, 5611.0741727614895, 27183.0, 27196.728032719817, 27700.168994930184, 28071.57892631612, 28373.574396384072, 2167.198136689435, 2233.363491404958, 2238.1159442020476, 2240.0, 2240.361496973355, 17463.65072698539, 17666.734998975026, 17739.11304434786, 18107.366242181593, 18307.63384732311, 2115.079940226007, 2123.288698286076, 2167.5448155887125, 2169.717936668223, 2171.2834764527825, 150131.0, 152764.0, 154892.22553887157, 155538.0, 157872.0, 11788.88211117895, 12437.315947622968, 12451.688707782378, 12462.5014999399, 12467.625971220878, 16666.749998750027, 16739.748903766453, 16774.58063548421, 16795.16024198785, 16816.495505134866, 7452.105747310357, 7650.655720492591, 7688.154303026663, 7746.806329841799, 7787.415943804237, 6812.727490900308, 6833.248342682301, 6838.829029274308, 6975.895361569581, 6999.545029573163, 7650.579218142944, 7806.336461400844, 7817.843643127106, 7818.335441487424, 7823.569703666353, 2097.339338108491, 2108.3042595943302, 2112.1445814445174, 2113.2075471698113, 2260.423591984066, 942.236788201559, 950.9762255943518, 953.68051702679, 954.3939598355095, 978.7797745507346, 20041.799582004285, 20402.795972040385, 20464.38606841797, 20539.075741591663, 20810.895945520177, 935.8081593273363, 966.8211380894417, 998.3161534348994, 1003.7390278527636, 1007.969760907174, 9354.438733676001, 10106.0, 10710.89289107099, 10844.024037836632, 10925.726856828644, 532780.0, 545744.0, 547823.0, 556129.0, 560004.0, 131612.0, 136806.0, 137954.31022845022, 138308.61691382958, 138530.0, 1187.827764974074, 1201.66353421044, 1232.2052276281747, 1238.467458992642, 1243.6269119264184, 17378.76723906508, 21560.59856109348, 22385.0, 22523.436914076625, 22597.2090976815, 58362.4163758374, 58367.70816145892, 58706.706466467396, 59436.70281648564, 59568.0, 79634.0, 81020.0, 81513.77729333946, 81690.366192677, 81754.59122704348, 7189.978873520075, 7917.327027202752, 8430.45202061864, 8667.609957551798, 9191.77020574491, 10130.746731331481, 13788.586342409744, 13856.653583660489, 14273.0, 14371.568852934428, 10434.634787782392, 11566.958973692408, 11674.182807203415, 12002.63992080239, 12073.27560346382, 10764.138868890626, 10986.670399888017, 11154.996050355507, 11168.385738784445, 11271.0, 9605.519724013631, 11716.17986740954, 11732.882671173178, 12076.879231207575, 12148.27110373345, 8840.911590884267, 8913.0, 8965.237954773916, 8997.37018408705, 9011.369204155646, 11569.6529104127, 11744.86658069629, 11910.166288359731, 11915.987141093105, 11999.280043197436], "value": 10357.200482604707, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1160.646002969094, 1243.179501528991, 1337.2711872029743, 1389.5761792653236, 1412.7810189420636, 9683.370580912237, 10182.74543136422, 11558.0, 11786.646400607973, 11823.881761182385, 11375.886241137587, 11478.311301321926, 11484.483198256077, 11488.942555287213, 11509.654710358702, 2461.0401943242196, 2500.499900019994, 2505.5615267328235, 2507.0, 2507.862067586282, 2033.4408037789651, 2097.1716172112083, 2175.2930297653247, 2544.73280305568, 2549.821512494126, 2366.7751563601432, 2388.940276493084, 2394.449276666368, 2401.831871768968, 2403.194929698553, 2431.6474111253856, 2474.34429876083, 2474.764897334768, 2476.1209770531473, 2479.1323036937106, 2434.732179460258, 2449.448874003353, 2450.0, 2451.460678650712, 2461.9138330158357, 11377.601783937605, 11613.30320180792, 11623.476943537562, 11639.709007274801, 11659.533618655243, 6489.1888513935755, 6734.7642832501115, 6740.0, 6746.359095885883, 6758.966205168992, 3609.043603445089, 3973.5033120859894, 4085.285075111873, 4190.8533201337805, 4216.966843123454, 1229.551213806954, 1265.5633806336798, 1281.653953432568, 1282.5254655777328, 1282.7947528395412, 16721.331146754113, 16725.247363868777, 16735.330586776516, 16755.581110472212, 16786.496405107868, 5729.54163666914, 5798.159266906275, 5863.589548731547, 6019.097135429633, 6172.382761723792, 13968.161910285415, 13968.301584920713, 13968.58094257174, 13997.370118344495, 14001.5099471518, 6707.865842683119, 6710.463162946952, 6714.932850671431, 6717.1267735194115, 6719.0, 5266.394364648115, 6102.084687296941, 6105.084237364431, 6120.418560236771, 6168.475679567197, 3361.562996810399, 4212.473440819897, 4217.261979153636, 4217.34631132175, 4217.418468074472, 1320.2870449957109, 1441.67562298482, 1482.2588705647177, 1482.4737218287569, 1485.5394827603477, 763.2443880558208, 775.685847231872, 789.3448437796615, 805.452292441134, 825.4263287015586, 6442.645654489048, 6706.664666766642, 6898.517103802686, 6935.479839012094, 6937.826554336081, 732.4653003307616, 896.3591032411857, 917.5137177296044, 940.7507010642186, 942.8350038743192, 3435.811030393302, 3811.6950643948417, 3818.427235914635, 3911.1786524830104, 3944.723869329119, 12355.505779768708, 13688.0, 14217.004809663431, 14606.269686515845, 15373.615659608598, 11999.460024298927, 13853.51512697071, 14143.29283535819, 14145.222012789396, 14178.85821141796, 7514.774556763306, 7619.435167311019, 8220.219079187467, 8729.345299102466, 8774.956125219333, 5811.912821307599, 6954.269801670954, 7159.749408770668, 7161.391281740902, 7207.495475316678, 13436.3627299465, 13558.86441135576, 13807.0, 13843.508168529359, 13875.236861972284, 11405.600803971822, 13673.384697688827, 13871.306434678427, 14067.437302507786, 14153.504627337994, 8770.561471926505, 8859.911400885909, 8861.98087219978, 9024.774380640274, 9481.857772133286, 10841.349519028883, 11057.391843448688, 11064.502097405475, 11072.778544428906, 11093.001629853352, 9042.367034307536, 9075.319351048829, 9179.495127768037, 9267.953660231655, 9419.199368053793, 7448.962755186406, 8962.283017358464, 9003.369764116449, 9092.136247056518, 9159.16066019536, 7492.51298665585, 7567.735129270449, 8220.054693710299, 8304.0, 8344.624491897757, 6014.548908831767, 6033.0340184759525, 6143.662098584621, 6200.875982480416, 6218.22272215973, 6083.543734219863, 6257.812265632038, 6283.874322513433, 6357.474240841377, 6404.935950640434], "value": 5336.435746203101, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [397.06491213192936, 398.9780562069085, 403.3445650817422, 403.75572778469035, 406.9430279760836, 5126.461721519243, 5359.67841929484, 5689.089745640693, 5957.9445091443495, 5973.701314934257, 5006.799728010875, 5577.358603760569, 5863.384344643815, 5872.17789509469, 5887.646741195521, 4061.24866899623, 4102.774347410891, 4223.978880105595, 4494.842680506183, 4496.55034496551, 4520.29935360018, 4525.230710779176, 4528.20756367636, 4528.320751887227, 4551.590356867881, 4351.58573463624, 4457.264551349023, 4460.241758900978, 4496.055828276066, 4513.909721805562, 3805.6004119567324, 3808.7905165215902, 4251.3622956556455, 4437.955620443802, 4452.243118669818, 3507.2810073934784, 3798.3542797724176, 4013.678905687538, 4021.055052062763, 4029.9395509067094, 4848.757562121879, 5035.597152227813, 5044.596432285409, 5061.519155680205, 5197.882455272134, 4565.474970378383, 5247.586110389226, 5396.271503347037, 5399.163129714901, 5399.676019438807, 6177.783777567808, 6237.438630523229, 6265.71804268809, 6283.3088360280335, 6287.598680923372, 4411.536788637179, 4496.279750750814, 4541.0, 4544.500104988449, 4549.9990002199465, 5263.4473380295285, 6091.634501929854, 6330.65181415022, 6616.86766264672, 6627.900581491282, 4508.504064552896, 4653.162430762495, 4744.644151688568, 4755.5719985201495, 4760.904781904412, 4134.710570260053, 4805.674892596691, 4839.879003024953, 4860.0, 4860.513948605111, 4375.737455752601, 4468.128714900628, 5358.758855851496, 5393.813361060639, 5440.211169380497, 6299.275583307978, 6314.842128946813, 6322.178116844781, 6324.525660575383, 6329.525285603506, 1397.6715471864104, 1471.9264036798118, 1489.2330449818353, 1571.6149543361948, 1674.6315810521667, 960.2989817433313, 960.8991055939166, 977.3793641037992, 985.6353149334792, 994.5773046455228, 5005.9749701251985, 5284.617844579472, 5971.58198926071, 5971.701414929236, 5973.581849270509, 5825.067989121805, 5953.672548009901, 6427.164468619049, 6488.935110648928, 6505.544611877218, 5804.912926306109, 5885.852853678607, 5939.673317967553, 5967.492763115184, 5987.970060149759, 2973.3012742005612, 3355.798652080883, 3405.4551271796395, 3405.7956522608724, 3421.6749408806622, 5769.826905192851, 6059.757609695651, 6675.496688741722, 6697.631630260285, 6724.66376681164, 5537.889242215133, 6647.534672572873, 6661.433778128913, 6671.833204169935, 6672.0, 5711.600187986801, 5791.015527360275, 5915.816836632691, 6365.99471166581, 6710.261871194165, 5323.0, 6431.099646049463, 6443.226812782496, 6451.3226111257645, 6453.806385808433, 5561.360443549043, 6054.939450605438, 6342.399616157353, 6353.77761778354, 6374.23509178883, 4917.704937703749, 6056.788012419544, 6381.329960354282, 6697.899531507129, 6720.092787473628, 3930.2336044471053, 3950.683945284313, 4235.724677895927, 4246.3842742802735, 4268.125034367885, 6363.695442434382, 6453.45145662624, 6474.384933431316, 6528.21661400635, 6551.50863685216, 5223.138182199895, 5871.882562348815, 6133.834571431414, 6260.843478913063, 6274.905876411949, 4979.0788704089855, 5283.89432211346, 5930.644161350333, 6072.392760723892, 6078.179445774941, 4558.020025694492, 5304.310439642822, 5766.452187042224, 5928.992071347795, 6209.59637623553, 5447.972760136333, 6259.530535209969, 6273.964795808641, 6327.272363678236, 6351.587146835441, 5596.496315331639, 5964.463198312173, 6030.547708921761, 6089.604175728564, 6153.169322141633], "value": 4581.183994059915, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [761.7486229544251, 830.9958450207748, 841.6423020216406, 861.7587075618825, 867.0462491259615, 16160.83839161611, 16285.83714162858, 16703.0, 16709.83290167098, 16757.413490527848, 15559.988600740971, 15571.377144914219, 15765.369385224605, 15776.0534367938, 15790.842091579081, 952.5237381309346, 958.5734348215047, 959.7792507723228, 960.0639376607821, 990.7770751580908, 995.3579940938091, 1012.2205901455875, 1021.2748948246754, 1027.9126274266696, 1042.1298215989657, 1079.0180935348835, 1080.18446073215, 1081.3403823667556, 1083.3012706804107, 1083.8103331916923, 1071.5927947379985, 1078.5739632844982, 1078.6925726168045, 1080.751427171751, 1081.6160263106563, 806.7983004248938, 809.9838003239961, 810.9270165685117, 812.9512229266263, 813.7233340664144, 16080.276387562588, 16096.195190240558, 16208.108554029524, 16904.239309231114, 17170.141492925428, 16797.91601041999, 16824.57938551534, 17021.31914723422, 17215.913920430317, 17270.395536156175, 13858.4456621735, 13927.651808704763, 13953.0, 13960.162390256617, 14170.858291417057, 3486.4595987621706, 3508.1405055761247, 3511.7892926424242, 3515.2793677296095, 3516.261585067139, 67802.66098669525, 130954.34522827421, 133161.33419332939, 134250.3287483566, 136227.31886340506, 10448.477576121164, 11111.444427778579, 11295.49170287339, 11390.25963312382, 11395.088392928546, 19126.904365478083, 24612.384690382885, 24752.25743227706, 24772.25683229506, 25066.99732010699, 7790.143084260727, 7894.407919406068, 7897.486663366978, 7901.881471777928, 7904.328132108835, 3792.943105853414, 3871.845126194921, 3874.8837534874, 3934.2918274710255, 3943.152222272225, 4149.294619914562, 4239.448871646728, 4242.7242229255, 4243.98144445337, 4248.702590818613, 810.6433169405443, 847.817719190377, 856.2678909532385, 857.2756021162108, 858.6522458404356, 655.2955572759303, 663.5918909870395, 673.1417442760519, 674.4031532094034, 688.3907741648677, 10647.414392208348, 11682.532698692126, 11964.607782890389, 11975.341356225317, 12142.575009874789, 654.3881470824793, 656.2584279763931, 658.2200092889941, 660.1945626335862, 670.9630970296583, 5430.348358196962, 5570.192322113352, 5623.606347555714, 5661.179129026268, 5672.659640421588, 104433.43349849759, 106409.0, 106685.0, 107975.46012269889, 110334.44832775946, 93910.0, 95076.0, 97747.0, 98059.01940980641, 98429.0, 61519.077213841825, 74868.62565687245, 76413.0, 77969.0, 79149.81275280875, 10676.83984740245, 10967.616133435291, 11441.362029178035, 11988.400579971141, 12748.49006039748, 31656.5251521232, 39775.80112099421, 40802.591974081064, 41251.38122928098, 41700.58299416967, 73760.52478950498, 75300.62349688217, 75648.0, 75649.62175189088, 77058.22941770735, 15843.445479408627, 15956.920215398848, 16002.19989000522, 16106.0, 16552.924059936067, 17486.0, 18075.36736214226, 18187.363442279457, 18262.36081737133, 18461.630767384308, 16044.518664440086, 16488.505344839676, 16501.0, 16584.336626534805, 16605.667886641957, 15975.68048639044, 16194.352225910832, 16556.586085347964, 16645.667086657955, 16693.666126677643, 15732.685346292781, 15882.364705411654, 16027.198640068184, 16307.836921630631, 16446.342146314015, 11235.651856700937, 11241.943790280997, 11313.490892910004, 11402.372869491926, 11480.425978700865, 13166.210027398387, 13555.59333220005, 13565.525206618116, 13585.52450664222, 13654.112482688593], "value": 8333.67626024711, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1426.6999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 110.0, 111.0, 111.0, 111.0, 111.0, 110.0, 111.0, 111.0, 112.0], "value": 110.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 114.0, 102.0, 161.0, 106.0, 110.0, 108.0, 107.0, 135.0, 107.0], "value": 119.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [187.0, 186.0, 183.0, 185.0, 187.0, 187.0, 183.0, 187.0, 186.0, 183.0], "value": 185.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 56.0, 58.0, 89.0, 57.0, 58.0, 57.0, 57.0, 88.0, 47.0], "value": 64.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 70.0, 84.0, 68.0, 69.0, 72.0, 89.0, 70.0, 67.0, 90.0], "value": 76.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 86.0, 87.0, 86.0, 88.0, 91.0, 87.0, 88.0, 88.0, 87.0], "value": 87.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 94.0, 94.0, 94.0, 94.0, 93.0, 94.0, 94.0, 95.0, 94.0], "value": 94.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 84.0, 85.0, 83.0, 85.0, 83.0, 84.0, 84.0, 85.0], "value": 84.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [49.0, 46.0, 47.0, 46.0, 46.0, 49.0, 48.0, 47.0, 47.0, 49.0], "value": 47.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 62.0, 64.0, 98.0, 91.0, 74.0, 75.0, 49.0, 53.0, 62.0], "value": 68.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 82.0, 82.0, 82.0, 82.0, 83.0, 81.0, 80.0, 80.0], "value": 81.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [137.0, 152.0, 141.0, 133.0, 133.0, 137.0, 136.0, 139.0, 174.0, 153.0], "value": 143.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [185.0, 187.0, 182.0, 186.0, 181.0, 181.0, 189.0, 231.0, 203.0, 186.0], "value": 191.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 93.0, 98.0, 68.0, 67.0, 68.0, 69.0, 67.0, 67.0, 68.0], "value": 72.2, "unit": "score"}]}]} 07:28:16 INFO - Return code: 0 07:28:16 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 07:28:16 INFO - # TBPL SUCCESS # 07:28:16 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 07:28:16 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 07:28:16 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 07:28:16 INFO - 2017-05-10 07:28:16.663 screenresolution[2363:30748] starting screenresolution argv=screenresolution get 07:28:16 INFO - 2017-05-10 07:28:16.666 screenresolution[2363:30748] Display 0: 1600x1200x32@60 07:28:16 INFO - 2017-05-10 07:28:16.673 screenresolution[2364:30750] starting screenresolution argv=screenresolution list 07:28:16 INFO - Available Modes on Display 0 07:28:16 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 07:28:16 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 07:28:16 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 07:28:16 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 07:28:16 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 07:28:16 INFO - Intel Iris: 07:28:16 INFO - Chipset Model: Intel Iris 07:28:16 INFO - Type: GPU 07:28:16 INFO - Bus: Built-In 07:28:16 INFO - VRAM (Dynamic, Max): 1536 MB 07:28:16 INFO - Vendor: Intel (0x8086) 07:28:16 INFO - Device ID: 0x0a2e 07:28:16 INFO - Revision ID: 0x0009 07:28:16 INFO - Displays: 07:28:16 INFO - Display: 07:28:16 INFO - Resolution: 1600 x 1200 @ 60 Hz 07:28:16 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 07:28:16 INFO - Display Serial Number: 1600x1200 60 07:28:16 INFO - Main Display: Yes 07:28:16 INFO - Mirror: Off 07:28:16 INFO - Online: Yes 07:28:16 INFO - Rotation: Supported 07:28:16 INFO - Return code: 0 07:28:16 INFO - Running post-action listener: _resource_record_post_action 07:28:16 INFO - [mozharness: 2017-05-10 14:28:16.909964Z] Finished run-tests step (success) 07:28:16 INFO - Running post-run listener: _resource_record_post_run 07:28:16 INFO - Total resource usage - Wall time: 1200s; CPU: 53.0%; Read bytes: 1335296; Write bytes: 527331840; Read time: 9; Write time: 1789 07:28:16 INFO - TinderboxPrint: CPU usage
53.3% 07:28:16 INFO - TinderboxPrint: I/O read bytes / time
1,335,296 / 9 07:28:16 INFO - TinderboxPrint: I/O write bytes / time
527,331,840 / 1,789 07:28:16 INFO - TinderboxPrint: CPU idle
2,242.5 (46.7%) 07:28:16 INFO - TinderboxPrint: CPU system
956.1 (19.9%) 07:28:16 INFO - TinderboxPrint: CPU user
1,603.2 (33.4%) 07:28:16 INFO - TinderboxPrint: Swap in / out
214,192,128 / 0 07:28:16 INFO - install - Wall time: 21s; CPU: 54.0%; Read bytes: 206320128; Write bytes: 204193792; Read time: 15958; Write time: 358 07:28:16 INFO - run-tests - Wall time: 1180s; CPU: 53.0%; Read bytes: 1335296; Write bytes: 313254400; Read time: 9; Write time: 1398 07:28:17 INFO - Running post-run listener: _upload_blobber_files 07:28:17 INFO - Blob upload gear active. 07:28:17 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:28:17 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 07:28:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:28:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:28:17 INFO - (blobuploader) - INFO - Open directory for files ... 07:28:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 07:28:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:28:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:28:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 07:28:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:28:18 INFO - (blobuploader) - INFO - Done attempting. 07:28:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 07:28:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:28:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:28:19 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 07:28:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:28:19 INFO - (blobuploader) - INFO - Done attempting. 07:28:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 07:28:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:28:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:28:20 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 07:28:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:28:20 INFO - (blobuploader) - INFO - Done attempting. 07:28:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 07:28:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:28:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:28:23 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 07:28:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:28:23 INFO - (blobuploader) - INFO - Done attempting. 07:28:23 INFO - (blobuploader) - INFO - Iteration through files over. 07:28:23 INFO - Return code: 0 07:28:23 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:28:23 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:28:23 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/851bc038d28d7d458ad214d51574759814567870b40d61c5e2721429409ff4eaea51a8e4ee6a81bb0c93902b8196ad3985b28a233cf1e7d9570ab0ef9941c4e2", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b71e5ddb872ebf7ab67bd6bcdccb53d0c86964aba0a031c58fd72702f9b0919aa15c640cf78db3b7a0d72723d0a9bbc9aa29c1fc8a248356fb34bcda447a5716", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/19e941edc4b3aefc1f878bd156ef621d278bb3d845ce3c344a2a2be6c93fe34af635e4d3e9d1790e0481c59402dfdbcd5b7d53b7d7b757779986f75af71eb434", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7fcda302704ac6c7a3eca9329e2079e7048df2329ca6519e6f513d0fbd6da3e057bba78abc2bafb9de1586c7a1a285f0da3b795c863cce989c4eb8c97e065e0a"} 07:28:23 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:28:23 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:28:23 INFO - Contents: 07:28:23 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/851bc038d28d7d458ad214d51574759814567870b40d61c5e2721429409ff4eaea51a8e4ee6a81bb0c93902b8196ad3985b28a233cf1e7d9570ab0ef9941c4e2", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b71e5ddb872ebf7ab67bd6bcdccb53d0c86964aba0a031c58fd72702f9b0919aa15c640cf78db3b7a0d72723d0a9bbc9aa29c1fc8a248356fb34bcda447a5716", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/19e941edc4b3aefc1f878bd156ef621d278bb3d845ce3c344a2a2be6c93fe34af635e4d3e9d1790e0481c59402dfdbcd5b7d53b7d7b757779986f75af71eb434", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7fcda302704ac6c7a3eca9329e2079e7048df2329ca6519e6f513d0fbd6da3e057bba78abc2bafb9de1586c7a1a285f0da3b795c863cce989c4eb8c97e065e0a"} 07:28:23 INFO - Running post-run listener: copy_logs_to_upload_dir 07:28:23 INFO - Copying logs to upload dir... 07:28:23 INFO - mkdir: /builds/slave/test/build/upload/logs 07:28:23 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1276.199679 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 16 secs) (at 2017-05-10 07:28:23.465363) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-10 07:28:23.469357) ========= 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.aPV85Ygjha/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.HPCBccPTkq/Listeners TMPDIR=/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/851bc038d28d7d458ad214d51574759814567870b40d61c5e2721429409ff4eaea51a8e4ee6a81bb0c93902b8196ad3985b28a233cf1e7d9570ab0ef9941c4e2", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b71e5ddb872ebf7ab67bd6bcdccb53d0c86964aba0a031c58fd72702f9b0919aa15c640cf78db3b7a0d72723d0a9bbc9aa29c1fc8a248356fb34bcda447a5716", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/19e941edc4b3aefc1f878bd156ef621d278bb3d845ce3c344a2a2be6c93fe34af635e4d3e9d1790e0481c59402dfdbcd5b7d53b7d7b757779986f75af71eb434", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7fcda302704ac6c7a3eca9329e2079e7048df2329ca6519e6f513d0fbd6da3e057bba78abc2bafb9de1586c7a1a285f0da3b795c863cce989c4eb8c97e065e0a"} build_url:https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011306 build_url: 'https://queue.taskcluster.net/v1/task/MGU9MRTwSzur05Fp4DmOvA/artifacts/public/build/firefox-55.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/851bc038d28d7d458ad214d51574759814567870b40d61c5e2721429409ff4eaea51a8e4ee6a81bb0c93902b8196ad3985b28a233cf1e7d9570ab0ef9941c4e2", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b71e5ddb872ebf7ab67bd6bcdccb53d0c86964aba0a031c58fd72702f9b0919aa15c640cf78db3b7a0d72723d0a9bbc9aa29c1fc8a248356fb34bcda447a5716", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/19e941edc4b3aefc1f878bd156ef621d278bb3d845ce3c344a2a2be6c93fe34af635e4d3e9d1790e0481c59402dfdbcd5b7d53b7d7b757779986f75af71eb434", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7fcda302704ac6c7a3eca9329e2079e7048df2329ca6519e6f513d0fbd6da3e057bba78abc2bafb9de1586c7a1a285f0da3b795c863cce989c4eb8c97e065e0a"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-10 07:28:23.505076) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 07:28:23.505613) ========= 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.aPV85Ygjha/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.HPCBccPTkq/Listeners TMPDIR=/var/folders/vl/13zsdy5s2c70rd9lzswz9gd000000w/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.005220 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 07:28:23.557553) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-10 07:28:23.557947) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-10 07:28:23.558306) ========= ========= Total master_lag: 0.19 =========