builder: mozilla-aurora_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0115 starttime: 1474375496.36 results: success (0) buildid: 20160920033516 builduid: bb043a864b894281a3bf793d20161b3c revision: 1b6882dcc4bc7740ec4572b8407a9fc9579ba0e2 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:56.357799) ========= master: http://buildbot-master133.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:56.358295) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:56.358578) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:56.385779) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:56.386218) ========= 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.HCvaW0txhQ/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.7d18rZP3IN/Listeners TMPDIR=/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-09-20 05:44:56-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 184M=0s 2016-09-20 05:44:56 (184 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.097018 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:56.509359) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:56.509673) ========= 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.HCvaW0txhQ/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.7d18rZP3IN/Listeners TMPDIR=/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/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.027941 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:56.558479) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-20 05:44:56.558826) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 1b6882dcc4bc7740ec4572b8407a9fc9579ba0e2 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 1b6882dcc4bc7740ec4572b8407a9fc9579ba0e2 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.HCvaW0txhQ/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.7d18rZP3IN/Listeners TMPDIR=/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-09-20 05:44:56,940 truncating revision to first 12 chars 2016-09-20 05:44:56,941 Setting DEBUG logging. 2016-09-20 05:44:56,941 attempt 1/10 2016-09-20 05:44:56,941 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/1b6882dcc4bc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-20 05:44:58,321 unpacking tar archive at: mozilla-aurora-1b6882dcc4bc/testing/mozharness/ program finished with exit code 0 elapsedTime=1.657326 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-20 05:44:58.245331) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:58.245712) ========= script_repo_revision: 1b6882dcc4bc7740ec4572b8407a9fc9579ba0e2 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:58.246108) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:58.246372) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-20 05:44:58.265913) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2016-09-20 05:44:58.266183) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.HCvaW0txhQ/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.7d18rZP3IN/Listeners TMPDIR=/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 05:44:58 INFO - MultiFileLogger online at 20160920 05:44:58 in /builds/slave/test 05:44:58 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 05:44:58 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:44:58 INFO - {'append_to_log': False, 05:44:58 INFO - 'base_work_dir': '/builds/slave/test', 05:44:58 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 05:44:58 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:44:58 INFO - 'branch': 'Mozilla-Aurora', 05:44:58 INFO - 'buildbot_json_path': 'buildprops.json', 05:44:58 INFO - 'config_files': ('talos/mac_config.py',), 05:44:58 INFO - 'default_actions': ('clobber', 05:44:58 INFO - 'read-buildbot-config', 05:44:58 INFO - 'download-and-extract', 05:44:58 INFO - 'populate-webroot', 05:44:58 INFO - 'create-virtualenv', 05:44:58 INFO - 'install', 05:44:58 INFO - 'run-tests'), 05:44:58 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:44:58 INFO - 'download_minidump_stackwalk': True, 05:44:58 INFO - 'download_symbols': 'ondemand', 05:44:58 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:44:58 INFO - 'tooltool.py': '/tools/tooltool.py', 05:44:58 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:44:58 INFO - '/tools/misc-python/virtualenv.py')}, 05:44:58 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:44:58 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:44:58 INFO - 'installer_path': 'installer.exe', 05:44:58 INFO - 'log_level': 'info', 05:44:58 INFO - 'log_name': 'talos', 05:44:58 INFO - 'log_to_console': True, 05:44:58 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 05:44:58 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 05:44:58 INFO - 'opt_config_files': (), 05:44:58 INFO - 'pip_index': False, 05:44:58 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:44:58 INFO - 'cmd': ('bash', 05:44:58 INFO - '-c', 05:44:58 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:44:58 INFO - 'enabled': True, 05:44:58 INFO - 'halt_on_failure': False, 05:44:58 INFO - 'name': 'check_screen_resolution'},), 05:44:58 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:44:58 INFO - 'cmd': ('bash', 05:44:58 INFO - '-c', 05:44:58 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:44:58 INFO - 'enabled': True, 05:44:58 INFO - 'halt_on_failure': False, 05:44:58 INFO - 'name': 'check_screen_resolution'},), 05:44:58 INFO - 'run_cmd_checks_enabled': True, 05:44:58 INFO - 'sps_profile': False, 05:44:58 INFO - 'sps_profile_interval': 0, 05:44:58 INFO - 'suite': 'dromaeojs-e10s', 05:44:58 INFO - 'system_bits': '32', 05:44:58 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:44:58 INFO - 'title': 't-yosemite-r7-0115', 05:44:58 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:44:58 INFO - 'use_talos_json': True, 05:44:58 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:44:58 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:44:58 INFO - 'work_dir': 'build'} 05:44:58 INFO - [mozharness: 2016-09-20 12:44:58.784092Z] Running clobber step. 05:44:58 INFO - Running pre-action listener: _resource_record_pre_action 05:44:58 INFO - Running main action method: clobber 05:44:58 INFO - rmtree: /builds/slave/test/build 05:44:58 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:45:00 INFO - Running post-action listener: _resource_record_post_action 05:45:01 INFO - [mozharness: 2016-09-20 12:45:01.000284Z] Finished clobber step (success) 05:45:01 INFO - [mozharness: 2016-09-20 12:45:01.000530Z] Running read-buildbot-config step. 05:45:01 INFO - Running pre-action listener: _resource_record_pre_action 05:45:01 INFO - Running main action method: read_buildbot_config 05:45:01 INFO - Using buildbot properties: 05:45:01 INFO - { 05:45:01 INFO - "project": "", 05:45:01 INFO - "product": "firefox", 05:45:01 INFO - "script_repo_revision": "production", 05:45:01 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs-e10s", 05:45:01 INFO - "repository": "", 05:45:01 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs-e10s", 05:45:01 INFO - "buildid": "20160920033516", 05:45:01 INFO - "pgo_build": "False", 05:45:01 INFO - "basedir": "/builds/slave/test", 05:45:01 INFO - "buildnumber": 124, 05:45:01 INFO - "slavename": "t-yosemite-r7-0115", 05:45:01 INFO - "master": "http://buildbot-master133.bb.releng.scl3.mozilla.com:8201/", 05:45:01 INFO - "platform": "yosemite_r7", 05:45:01 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 05:45:01 INFO - "branch": "mozilla-aurora", 05:45:01 INFO - "repo_path": "releases/mozilla-aurora", 05:45:01 INFO - "revision": "1b6882dcc4bc7740ec4572b8407a9fc9579ba0e2", 05:45:01 INFO - "stage_platform": "macosx64", 05:45:01 INFO - "builduid": "bb043a864b894281a3bf793d20161b3c", 05:45:01 INFO - "slavebuilddir": "test" 05:45:01 INFO - } 05:45:01 INFO - Found installer url https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg. 05:45:01 INFO - Running post-action listener: _resource_record_post_action 05:45:01 INFO - [mozharness: 2016-09-20 12:45:01.006134Z] Finished read-buildbot-config step (success) 05:45:01 INFO - [mozharness: 2016-09-20 12:45:01.006281Z] Running download-and-extract step. 05:45:01 INFO - Running pre-action listener: _resource_record_pre_action 05:45:01 INFO - Running main action method: download_and_extract 05:45:01 INFO - mkdir: /builds/slave/test/build/tests 05:45:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:01 INFO - trying https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json 05:45:01 INFO - Downloading https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 05:45:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json'}, attempt #1 05:45:02 INFO - Downloaded 1199 bytes. 05:45:02 INFO - Reading from file /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 05:45:02 INFO - Using the following test package requirements: 05:45:02 INFO - {u'common': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 05:45:02 INFO - u'cppunittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:45:02 INFO - u'firefox-51.0a2.en-US.mac.cppunittest.tests.zip'], 05:45:02 INFO - u'gtest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:45:02 INFO - u'firefox-51.0a2.en-US.mac.gtest.tests.zip'], 05:45:02 INFO - u'jittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:45:02 INFO - u'jsshell-mac.zip'], 05:45:02 INFO - u'mochitest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:45:02 INFO - u'firefox-51.0a2.en-US.mac.mochitest.tests.zip'], 05:45:02 INFO - u'mozbase': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 05:45:02 INFO - u'reftest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:45:02 INFO - u'firefox-51.0a2.en-US.mac.reftest.tests.zip'], 05:45:02 INFO - u'talos': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:45:02 INFO - u'firefox-51.0a2.en-US.mac.talos.tests.zip'], 05:45:02 INFO - u'web-platform': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:45:02 INFO - u'firefox-51.0a2.en-US.mac.web-platform.tests.zip'], 05:45:02 INFO - u'xpcshell': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 05:45:02 INFO - u'firefox-51.0a2.en-US.mac.xpcshell.tests.zip']} 05:45:02 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip'] for test suite category: common 05:45:02 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 05:45:02 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 05:45:02 INFO - Fetch https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 05:45:02 INFO - Expected file size: 16426246 05:45:10 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip', u'firefox-51.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 05:45:10 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 05:45:10 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 05:45:10 INFO - Fetch https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 05:45:10 INFO - Expected file size: 16426246 05:45:17 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip 05:45:17 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip'}, attempt #1 05:45:17 INFO - Fetch https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip into memory 05:45:17 INFO - Expected file size: 14414059 05:45:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:18 INFO - trying https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 05:45:18 INFO - Downloading https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg 05:45:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg'}, attempt #1 05:45:22 INFO - Downloaded 115241527 bytes. 05:45:22 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 05:45:22 INFO - mkdir: /builds/slave/test/properties 05:45:22 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:45:22 INFO - Writing to file /builds/slave/test/properties/build_url 05:45:22 INFO - Contents: 05:45:22 INFO - build_url:https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 05:45:22 INFO - Running post-action listener: _resource_record_post_action 05:45:22 INFO - Running post-action listener: set_extra_try_arguments 05:45:22 INFO - [mozharness: 2016-09-20 12:45:22.941713Z] Finished download-and-extract step (success) 05:45:22 INFO - [mozharness: 2016-09-20 12:45:22.941851Z] Running populate-webroot step. 05:45:22 INFO - Running pre-action listener: _resource_record_pre_action 05:45:22 INFO - Running main action method: populate_webroot 05:45:22 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:45:22 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:45:22 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:45:22 INFO - '--tppagecycles', 05:45:22 INFO - '7'], 05:45:22 INFO - 'tests': ['tsvgm']}}, 05:45:22 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:45:22 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:45:22 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:45:22 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:45:22 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:45:22 INFO - 'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:45:22 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:45:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:45:22 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:45:22 INFO - 'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['damp', 'tps']}, 05:45:22 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:45:22 INFO - 'tests': ['damp', 'tps']}, 05:45:22 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['dromaeo_dom']}, 05:45:22 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:45:22 INFO - 'g4': {'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['basic_compositor_video']}, 05:45:22 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 05:45:22 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['a11yr', 05:45:22 INFO - 'ts_paint', 05:45:22 INFO - 'tpaint', 05:45:22 INFO - 'sessionrestore', 05:45:22 INFO - 'sessionrestore_no_auto_restore', 05:45:22 INFO - 'tabpaint']}, 05:45:22 INFO - 'other-e10s': {'tests': ['a11yr', 05:45:22 INFO - 'ts_paint', 05:45:22 INFO - 'tpaint', 05:45:22 INFO - 'sessionrestore', 05:45:22 INFO - 'sessionrestore_no_auto_restore', 05:45:22 INFO - 'tabpaint']}, 05:45:22 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:45:22 INFO - 'ts_paint', 05:45:22 INFO - 'tpaint', 05:45:22 INFO - 'sessionrestore', 05:45:22 INFO - 'sessionrestore_no_auto_restore', 05:45:22 INFO - 'tabpaint']}, 05:45:22 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:45:22 INFO - 'ts_paint', 05:45:22 INFO - 'tpaint', 05:45:22 INFO - 'sessionrestore', 05:45:22 INFO - 'sessionrestore_no_auto_restore', 05:45:22 INFO - 'tabpaint']}, 05:45:22 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['a11yr', 05:45:22 INFO - 'ts_paint', 05:45:22 INFO - 'tpaint', 05:45:22 INFO - 'sessionrestore', 05:45:22 INFO - 'sessionrestore_no_auto_restore', 05:45:22 INFO - 'tabpaint']}, 05:45:22 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['a11yr', 05:45:22 INFO - 'ts_paint', 05:45:22 INFO - 'tpaint', 05:45:22 INFO - 'sessionrestore', 05:45:22 INFO - 'sessionrestore_no_auto_restore', 05:45:22 INFO - 'tabpaint']}, 05:45:22 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['tsvgx', 05:45:22 INFO - 'tsvgr_opacity', 05:45:22 INFO - 'tart', 05:45:22 INFO - 'tscrollx', 05:45:22 INFO - 'cart']}, 05:45:22 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:45:22 INFO - 'tsvgr_opacity', 05:45:22 INFO - 'tart', 05:45:22 INFO - 'tscrollx', 05:45:22 INFO - 'cart']}, 05:45:22 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:45:22 INFO - 'talos_options': ['--disable-e10s'], 05:45:22 INFO - 'tests': ['tp5o']}, 05:45:22 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:45:22 INFO - 'tests': ['tp5o']}, 05:45:22 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:45:22 INFO - 'talos_options': ['--disable-e10s', 05:45:22 INFO - '--xperf_path', 05:45:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:45:22 INFO - 'tests': ['tp5n']}, 05:45:22 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:45:22 INFO - 'talos_options': ['--xperf_path', 05:45:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:45:22 INFO - 'tests': ['tp5n']}}, 05:45:22 INFO - 'talos.zip': {'path': '', 05:45:22 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:45:22 INFO - Running post-action listener: _resource_record_post_action 05:45:22 INFO - [mozharness: 2016-09-20 12:45:22.962397Z] Finished populate-webroot step (success) 05:45:22 INFO - [mozharness: 2016-09-20 12:45:22.962529Z] Running create-virtualenv step. 05:45:22 INFO - Running pre-action listener: _resource_record_pre_action 05:45:22 INFO - Running main action method: create_virtualenv 05:45:22 INFO - Creating virtualenv /builds/slave/test/build/venv 05:45:22 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 05:45:22 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:45:23 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:45:23 INFO - Using real prefix '/tools/python27' 05:45:23 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:45:23 INFO - Installing distribute.............................................................................................................................................................................................done. 05:45:26 INFO - Installing pip.................done. 05:45:26 INFO - Return code: 0 05:45:26 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:45:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:26 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 05:45:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:45:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:26 INFO - 'HOME': '/Users/cltbld', 05:45:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:26 INFO - 'LOGNAME': 'cltbld', 05:45:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:26 INFO - 'MOZ_NO_REMOTE': '1', 05:45:26 INFO - 'NO_EM_RESTART': '1', 05:45:26 INFO - 'PAGER': '/bin/cat', 05:45:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:26 INFO - 'PWD': '/builds/slave/test', 05:45:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:26 INFO - 'SHELL': '/bin/bash', 05:45:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:26 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:26 INFO - 'USER': 'cltbld', 05:45:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:26 INFO - 'XPC_FLAGS': '0x0', 05:45:26 INFO - 'XPC_SERVICE_NAME': '0', 05:45:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:26 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 05:45:26 INFO - Cleaning up... 05:45:27 INFO - Return code: 0 05:45:27 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:45:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:27 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 05:45:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 05:45:27 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:27 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:27 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:27 INFO - 'HOME': '/Users/cltbld', 05:45:27 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:27 INFO - 'LOGNAME': 'cltbld', 05:45:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:27 INFO - 'MOZ_NO_REMOTE': '1', 05:45:27 INFO - 'NO_EM_RESTART': '1', 05:45:27 INFO - 'PAGER': '/bin/cat', 05:45:27 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:27 INFO - 'PWD': '/builds/slave/test', 05:45:27 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:27 INFO - 'SHELL': '/bin/bash', 05:45:27 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:27 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:27 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:27 INFO - 'USER': 'cltbld', 05:45:27 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:27 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:27 INFO - 'XPC_FLAGS': '0x0', 05:45:27 INFO - 'XPC_SERVICE_NAME': '0', 05:45:27 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:27 INFO - Downloading/unpacking psutil>=3.1.1 05:45:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:45:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:45:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:45:30 INFO - Installing collected packages: psutil 05:45:30 INFO - Running setup.py install for psutil 05:45:30 INFO - building 'psutil._psutil_osx' extension 05:45:30 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 05:45:31 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 05:45:31 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 05:45:31 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 05:45:31 INFO - building 'psutil._psutil_posix' extension 05:45:31 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 05:45:31 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 05:45:31 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 05:45:31 INFO - ^ 05:45:31 INFO - 1 warning generated. 05:45:31 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 05:45:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:45:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:45:31 INFO - Successfully installed psutil 05:45:31 INFO - Cleaning up... 05:45:31 INFO - Return code: 0 05:45:31 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:45:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:31 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 05:45:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 05:45:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:31 INFO - 'HOME': '/Users/cltbld', 05:45:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:31 INFO - 'LOGNAME': 'cltbld', 05:45:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:31 INFO - 'MOZ_NO_REMOTE': '1', 05:45:31 INFO - 'NO_EM_RESTART': '1', 05:45:31 INFO - 'PAGER': '/bin/cat', 05:45:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:31 INFO - 'PWD': '/builds/slave/test', 05:45:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:31 INFO - 'SHELL': '/bin/bash', 05:45:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:31 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:31 INFO - 'USER': 'cltbld', 05:45:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:31 INFO - 'XPC_FLAGS': '0x0', 05:45:31 INFO - 'XPC_SERVICE_NAME': '0', 05:45:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:32 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:45:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:34 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:45:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:45:34 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:45:34 INFO - Installing collected packages: mozsystemmonitor 05:45:34 INFO - Running setup.py install for mozsystemmonitor 05:45:34 INFO - Successfully installed mozsystemmonitor 05:45:34 INFO - Cleaning up... 05:45:34 INFO - Return code: 0 05:45:34 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:45:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:34 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 05:45:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 05:45:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:34 INFO - 'HOME': '/Users/cltbld', 05:45:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:34 INFO - 'LOGNAME': 'cltbld', 05:45:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:34 INFO - 'MOZ_NO_REMOTE': '1', 05:45:34 INFO - 'NO_EM_RESTART': '1', 05:45:34 INFO - 'PAGER': '/bin/cat', 05:45:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:34 INFO - 'PWD': '/builds/slave/test', 05:45:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:34 INFO - 'SHELL': '/bin/bash', 05:45:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:34 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:34 INFO - 'USER': 'cltbld', 05:45:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:34 INFO - 'XPC_FLAGS': '0x0', 05:45:34 INFO - 'XPC_SERVICE_NAME': '0', 05:45:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:35 INFO - Downloading/unpacking jsonschema==2.5.1 05:45:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:37 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:45:37 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:45:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:37 INFO - Downloading functools32-3.2.3-2.tar.gz 05:45:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:45:38 INFO - warning: no files found matching '*.txt' 05:45:38 INFO - no previously-included directories found matching 'build' 05:45:38 INFO - no previously-included directories found matching 'dist' 05:45:38 INFO - no previously-included directories found matching '.git*' 05:45:38 INFO - Installing collected packages: jsonschema, functools32 05:45:38 INFO - Running setup.py install for functools32 05:45:38 INFO - warning: no files found matching '*.txt' 05:45:38 INFO - no previously-included directories found matching 'build' 05:45:38 INFO - no previously-included directories found matching 'dist' 05:45:38 INFO - no previously-included directories found matching '.git*' 05:45:38 INFO - Successfully installed jsonschema functools32 05:45:38 INFO - Cleaning up... 05:45:38 INFO - Return code: 0 05:45:38 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 05:45:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:38 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 05:45:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 05:45:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:38 INFO - 'HOME': '/Users/cltbld', 05:45:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:38 INFO - 'LOGNAME': 'cltbld', 05:45:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:38 INFO - 'MOZ_NO_REMOTE': '1', 05:45:38 INFO - 'NO_EM_RESTART': '1', 05:45:38 INFO - 'PAGER': '/bin/cat', 05:45:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:38 INFO - 'PWD': '/builds/slave/test', 05:45:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:38 INFO - 'SHELL': '/bin/bash', 05:45:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:38 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:38 INFO - 'USER': 'cltbld', 05:45:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:38 INFO - 'XPC_FLAGS': '0x0', 05:45:38 INFO - 'XPC_SERVICE_NAME': '0', 05:45:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:38 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 05:45:38 INFO - Cleaning up... 05:45:38 INFO - Return code: 0 05:45:38 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:45:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:38 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 05:45:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:45:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:38 INFO - 'HOME': '/Users/cltbld', 05:45:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:38 INFO - 'LOGNAME': 'cltbld', 05:45:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:38 INFO - 'MOZ_NO_REMOTE': '1', 05:45:38 INFO - 'NO_EM_RESTART': '1', 05:45:38 INFO - 'PAGER': '/bin/cat', 05:45:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:38 INFO - 'PWD': '/builds/slave/test', 05:45:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:38 INFO - 'SHELL': '/bin/bash', 05:45:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:38 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:38 INFO - 'USER': 'cltbld', 05:45:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:38 INFO - 'XPC_FLAGS': '0x0', 05:45:38 INFO - 'XPC_SERVICE_NAME': '0', 05:45:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:38 INFO - Downloading/unpacking blobuploader==1.2.4 05:45:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:41 INFO - Downloading blobuploader-1.2.4.tar.gz 05:45:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:45:41 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:45:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:45:42 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:45:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:42 INFO - Downloading docopt-0.6.1.tar.gz 05:45:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:45:42 INFO - Installing collected packages: blobuploader, requests, docopt 05:45:42 INFO - Running setup.py install for blobuploader 05:45:42 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:45:42 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:45:42 INFO - Running setup.py install for requests 05:45:43 INFO - Running setup.py install for docopt 05:45:43 INFO - Successfully installed blobuploader requests docopt 05:45:43 INFO - Cleaning up... 05:45:43 INFO - Return code: 0 05:45:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:45:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:43 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:45:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:45:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:43 INFO - 'HOME': '/Users/cltbld', 05:45:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:43 INFO - 'LOGNAME': 'cltbld', 05:45:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:43 INFO - 'MOZ_NO_REMOTE': '1', 05:45:43 INFO - 'NO_EM_RESTART': '1', 05:45:43 INFO - 'PAGER': '/bin/cat', 05:45:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:43 INFO - 'PWD': '/builds/slave/test', 05:45:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:43 INFO - 'SHELL': '/bin/bash', 05:45:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:43 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:43 INFO - 'USER': 'cltbld', 05:45:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:43 INFO - 'XPC_FLAGS': '0x0', 05:45:43 INFO - 'XPC_SERVICE_NAME': '0', 05:45:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:45:43 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-j6IqKu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:45:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:45:43 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-KQ05lM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:45:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:45:43 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-LyWip1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-VYD18j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-jcvjfs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-sb_OqX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-zeOrEj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-CIZwKh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-Y_YBGG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-ppnHcC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-HcNAIP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-YeUt5D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:45:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:45:44 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-hFavGY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:45:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:45:45 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-3pLOb9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:45:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:45:45 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-Vqw7GP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:45:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:45:45 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-zHyz1P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:45:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:45:45 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-Zl72gG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:45:45 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:45:45 INFO - Running setup.py install for manifestparser 05:45:45 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:45:45 INFO - Running setup.py install for mozcrash 05:45:45 INFO - Running setup.py install for mozdebug 05:45:45 INFO - Running setup.py install for mozdevice 05:45:46 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Running setup.py install for mozfile 05:45:46 INFO - Running setup.py install for mozhttpd 05:45:46 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Running setup.py install for mozinfo 05:45:46 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Running setup.py install for mozInstall 05:45:46 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Running setup.py install for mozleak 05:45:46 INFO - Running setup.py install for mozlog 05:45:46 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:45:46 INFO - Running setup.py install for moznetwork 05:45:47 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:45:47 INFO - Running setup.py install for mozprocess 05:45:47 INFO - Running setup.py install for mozprofile 05:45:47 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:45:47 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:45:47 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:45:47 INFO - Running setup.py install for mozrunner 05:45:47 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:45:47 INFO - Running setup.py install for mozscreenshot 05:45:47 INFO - Running setup.py install for moztest 05:45:47 INFO - Running setup.py install for mozversion 05:45:48 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:45:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:45:48 INFO - Cleaning up... 05:45:48 INFO - Return code: 0 05:45:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:45: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')]} 05:45:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45: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')]} 05:45:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:48 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:45:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:45:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:48 INFO - 'HOME': '/Users/cltbld', 05:45:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:48 INFO - 'LOGNAME': 'cltbld', 05:45:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:48 INFO - 'MOZ_NO_REMOTE': '1', 05:45:48 INFO - 'NO_EM_RESTART': '1', 05:45:48 INFO - 'PAGER': '/bin/cat', 05:45:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:48 INFO - 'PWD': '/builds/slave/test', 05:45:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:48 INFO - 'SHELL': '/bin/bash', 05:45:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:48 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:48 INFO - 'USER': 'cltbld', 05:45:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:48 INFO - 'XPC_FLAGS': '0x0', 05:45:48 INFO - 'XPC_SERVICE_NAME': '0', 05:45:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:45:48 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-6Jz_Vs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:45:48 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 05:45:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:45:48 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-BoIERx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:45:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:45:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:45:48 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-rPDt_H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:45:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:45:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:45:48 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-umH3lN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:45:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:45:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:45:48 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-od5YAW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:45:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 05:45:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:45:48 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-2NL11C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:45:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 05:45:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:45:48 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-19UUft-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:45:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-wDQ6e4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:45:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-ceoaPq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:45:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-kAppR0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:45:49 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)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-vmF7Ys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:45:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-IF4DJ2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:45:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-TgTGpT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:45:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-Ob_wTi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:45:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-ek5IT5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:45:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 05:45:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:45:49 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-kVDbUW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:45:50 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 05:45:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:45:50 INFO - Running setup.py (path:/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/pip-j3zO54-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:45:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 05:45:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:45:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:45:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:45:50 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:45:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:45:50 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:45:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:45:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:45:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:45:52 INFO - Downloading blessings-1.6.tar.gz 05:45:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:45:52 INFO - Installing collected packages: blessings 05:45:52 INFO - Running setup.py install for blessings 05:45:52 INFO - Successfully installed blessings 05:45:52 INFO - Cleaning up... 05:45:52 INFO - Return code: 0 05:45:52 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:45:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:45:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:45:53 INFO - Reading from file tmpfile_stdout 05:45:53 INFO - Current package versions: 05:45:53 INFO - blessings == 1.6 05:45:53 INFO - blobuploader == 1.2.4 05:45:53 INFO - docopt == 0.6.1 05:45:53 INFO - functools32 == 3.2.3-2 05:45:53 INFO - jsonschema == 2.5.1 05:45:53 INFO - manifestparser == 1.1 05:45:53 INFO - mozInstall == 1.12 05:45:53 INFO - mozcrash == 0.17 05:45:53 INFO - mozdebug == 0.1 05:45:53 INFO - mozdevice == 0.48 05:45:53 INFO - mozfile == 1.2 05:45:53 INFO - mozhttpd == 0.7 05:45:53 INFO - mozinfo == 0.9 05:45:53 INFO - mozleak == 0.1 05:45:53 INFO - mozlog == 3.4 05:45:53 INFO - moznetwork == 0.27 05:45:53 INFO - mozprocess == 0.23 05:45:53 INFO - mozprofile == 0.28 05:45:53 INFO - mozrunner == 6.12 05:45:53 INFO - mozscreenshot == 0.1 05:45:53 INFO - mozsystemmonitor == 0.3 05:45:53 INFO - moztest == 0.7 05:45:53 INFO - mozversion == 1.4 05:45:53 INFO - psutil == 3.1.1 05:45:53 INFO - requests == 1.2.3 05:45:53 INFO - wsgiref == 0.1.2 05:45:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:45:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:53 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 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 05:45:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:45:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:53 INFO - 'HOME': '/Users/cltbld', 05:45:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:53 INFO - 'LOGNAME': 'cltbld', 05:45:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:53 INFO - 'MOZ_NO_REMOTE': '1', 05:45:53 INFO - 'NO_EM_RESTART': '1', 05:45:53 INFO - 'PAGER': '/bin/cat', 05:45:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:53 INFO - 'PWD': '/builds/slave/test', 05:45:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:53 INFO - 'SHELL': '/bin/bash', 05:45:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:53 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:53 INFO - 'USER': 'cltbld', 05:45:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:53 INFO - 'XPC_FLAGS': '0x0', 05:45:53 INFO - 'XPC_SERVICE_NAME': '0', 05:45:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:45:53 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:45:53 INFO - Cleaning up... 05:45:53 INFO - Return code: 0 05:45:53 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:45:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:45:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:45:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:45:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:45:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10d33d490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d2b3570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ffed04a3230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, '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.HCvaW0txhQ/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.7d18rZP3IN/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:45:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 05:45:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:45:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:45:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:45:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:45:53 INFO - 'HOME': '/Users/cltbld', 05:45:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:45:53 INFO - 'LOGNAME': 'cltbld', 05:45:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:45:53 INFO - 'MOZ_NO_REMOTE': '1', 05:45:53 INFO - 'NO_EM_RESTART': '1', 05:45:53 INFO - 'PAGER': '/bin/cat', 05:45:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:45:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:45:53 INFO - 'PWD': '/builds/slave/test', 05:45:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:45:53 INFO - 'SHELL': '/bin/bash', 05:45:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:45:53 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:45:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:45:53 INFO - 'USER': 'cltbld', 05:45:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:45:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:45:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:45:53 INFO - 'XPC_FLAGS': '0x0', 05:45:53 INFO - 'XPC_SERVICE_NAME': '0', 05:45:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:45:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:45:54 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:45:54 INFO - Cleaning up... 05:45:54 INFO - Return code: 0 05:45:54 INFO - Running post-action listener: _resource_record_post_action 05:45:54 INFO - Running post-action listener: _start_resource_monitoring 05:45:54 INFO - Starting resource monitoring. 05:45:54 INFO - [mozharness: 2016-09-20 12:45:54.090114Z] Finished create-virtualenv step (success) 05:45:54 INFO - [mozharness: 2016-09-20 12:45:54.091125Z] Running install step. 05:45:54 INFO - Running pre-action listener: _resource_record_pre_action 05:45:54 INFO - Running main action method: install 05:45:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:45:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:45:54 INFO - Reading from file tmpfile_stdout 05:45:54 INFO - Detecting whether we're running mozinstall >=1.0... 05:45:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:45:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:45:54 INFO - Reading from file tmpfile_stdout 05:45:54 INFO - Output received: 05:45:54 INFO - Usage: mozinstall [options] installer 05:45:54 INFO - Options: 05:45:54 INFO - -h, --help show this help message and exit 05:45:54 INFO - -d DEST, --destination=DEST 05:45:54 INFO - Directory to install application into. [default: 05:45:54 INFO - "/builds/slave/test"] 05:45:54 INFO - --app=APP Application being installed. [default: firefox] 05:45:54 INFO - mkdir: /builds/slave/test/build/application 05:45:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 05:45:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 05:46:26 INFO - Reading from file tmpfile_stdout 05:46:26 INFO - Output received: 05:46:26 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 05:46:26 INFO - Running post-action listener: _resource_record_post_action 05:46:26 INFO - [mozharness: 2016-09-20 12:46:26.419853Z] Finished install step (success) 05:46:26 INFO - [mozharness: 2016-09-20 12:46:26.419995Z] Running run-tests step. 05:46:26 INFO - Running pre-action listener: _resource_record_pre_action 05:46:26 INFO - Running main action method: run_tests 05:46:26 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:46:26 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:46:26 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:46:26 INFO - 2016-09-20 05:46:26.434 screenresolution[1635:7356] starting screenresolution argv=screenresolution get 05:46:26 INFO - 2016-09-20 05:46:26.436 screenresolution[1635:7356] Display 0: 1600x1200x32@60 05:46:26 INFO - 2016-09-20 05:46:26.442 screenresolution[1636:7358] starting screenresolution argv=screenresolution list 05:46:26 INFO - Available Modes on Display 0 05:46:26 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:46:26 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:46:26 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:46:26 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:46:26 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:46:26 INFO - Intel Iris: 05:46:26 INFO - Chipset Model: Intel Iris 05:46:26 INFO - Type: GPU 05:46:26 INFO - Bus: Built-In 05:46:26 INFO - VRAM (Dynamic, Max): 1536 MB 05:46:26 INFO - Vendor: Intel (0x8086) 05:46:26 INFO - Device ID: 0x0a2e 05:46:26 INFO - Revision ID: 0x0009 05:46:26 INFO - Displays: 05:46:26 INFO - Display: 05:46:26 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:46:26 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:46:26 INFO - Display Serial Number: 1600x1200 60 05:46:26 INFO - Main Display: Yes 05:46:26 INFO - Mirror: Off 05:46:26 INFO - Online: Yes 05:46:26 INFO - Rotation: Supported 05:46:26 INFO - Return code: 0 05:46:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:46:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:46:26 INFO - Python 2.7.3 05:46:26 INFO - Return code: 0 05:46:26 INFO - grabbing minidump binary from tooltool 05:46:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:46:26 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 0x10d151d30>, '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 0x10cfb7db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d149b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:46:26 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 05:46:26 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 05:46:26 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 05:46:26 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:46:26 INFO - Return code: 0 05:46:26 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 05:46:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:46:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:46:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 05:46:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:46:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0115', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 05:46:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0115 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:46:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HCvaW0txhQ/Render', 05:46:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:46:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:46:26 INFO - 'HOME': '/Users/cltbld', 05:46:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:46:26 INFO - 'LOGNAME': 'cltbld', 05:46:26 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:46:26 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 05:46:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:46:26 INFO - 'MOZ_NO_REMOTE': '1', 05:46:26 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:46:26 INFO - 'NO_EM_RESTART': '1', 05:46:26 INFO - 'PAGER': '/bin/cat', 05:46:26 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:46:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:46:26 INFO - 'PWD': '/builds/slave/test', 05:46:26 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:46:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:46:26 INFO - 'SHELL': '/bin/bash', 05:46:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7d18rZP3IN/Listeners', 05:46:26 INFO - 'TMPDIR': '/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/', 05:46:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:46:26 INFO - 'USER': 'cltbld', 05:46:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:46:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:46:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:46:26 INFO - 'XPC_FLAGS': '0x0', 05:46:26 INFO - 'XPC_SERVICE_NAME': '0', 05:46:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 05:46:26 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0115', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:46:27 INFO - mozversion application_buildid: 20160920033516 05:46:27 INFO - mozversion application_changeset: 1b6882dcc4bc7740ec4572b8407a9fc9579ba0e2 05:46:27 INFO - mozversion application_display_name: FirefoxDeveloperEdition 05:46:27 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:46:27 INFO - mozversion application_name: Firefox 05:46:27 INFO - mozversion application_remotingname: firefox-dev 05:46:27 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 05:46:27 INFO - mozversion application_vendor: Mozilla 05:46:27 INFO - mozversion application_version: 51.0a2 05:46:27 INFO - mozversion platform_buildid: 20160920033516 05:46:27 INFO - mozversion platform_changeset: 1b6882dcc4bc7740ec4572b8407a9fc9579ba0e2 05:46:27 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 05:46:27 INFO - mozversion platform_version: 51.0a2 05:46:27 INFO - using testdate: 1474375587 05:46:27 INFO - actual date: 1474375587 05:46:27 INFO - starting webserver on 'localhost:49266' 05:46:27 INFO - SUITE-START | Running 2 tests 05:46:27 INFO - TEST-START | dromaeo_css 05:46:27 INFO - operating with platform_type : mac_ 05:46:27 INFO - Initialising browser for dromaeo_css test... 05:46:27 INFO - TEST-INFO | started process 1646 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/tmpLfg7_w/profile http://localhost:49266/getInfo.html) 05:46:29 INFO - PROCESS | 1646 | __metrics Screen width/height:1600/1200 05:46:29 INFO - PROCESS | 1646 | colorDepth:24 05:46:29 INFO - PROCESS | 1646 | Browser inner width/height: 1024/689 05:46:29 INFO - PROCESS | 1646 | __metrics 05:46:29 ERROR - PROCESS | 1646 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 05:46:30 INFO - TEST-INFO | 1646: exit 0 05:46:30 INFO - Browser initialized. 05:46:30 INFO - Running cycle 1/1 for dromaeo_css test... 05:46:30 INFO - TEST-INFO | started process 1649 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/tmpLfg7_w/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:46:42 INFO - PROCESS | 1649 | RSS: Main: 224481280 05:46:42 INFO - PROCESS | 1649 | 05:47:32 INFO - PROCESS | 1649 | 1474375652196 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 05:49:44 INFO - PROCESS | 1649 | Cycle 1(1): loaded http://localhost:49266/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49266/tests/dromaeo/cssquery-ext.html) 05:49:46 INFO - PROCESS | 1649 | RSS: Main: 237142016 05:49:46 INFO - PROCESS | 1649 | 05:52:48 INFO - PROCESS | 1649 | Cycle 1(1): loaded http://localhost:49266/tests/dromaeo/cssquery-ext.html (next: http://localhost:49266/tests/dromaeo/cssquery-jquery.html) 05:52:49 INFO - PROCESS | 1649 | RSS: Main: 246939648 05:52:49 INFO - PROCESS | 1649 | 05:55:51 INFO - PROCESS | 1649 | Cycle 1(1): loaded http://localhost:49266/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49266/tests/dromaeo/cssquery-mootools.html) 05:55:51 INFO - PROCESS | 1649 | RSS: Main: 250703872 05:55:51 INFO - PROCESS | 1649 | 05:58:53 INFO - PROCESS | 1649 | Cycle 1(1): loaded http://localhost:49266/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49266/tests/dromaeo/cssquery-prototype.html) 05:58:54 INFO - PROCESS | 1649 | RSS: Main: 250744832 05:58:54 INFO - PROCESS | 1649 | 06:01:56 INFO - PROCESS | 1649 | Cycle 1(1): loaded http://localhost:49266/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49266/tests/dromaeo/cssquery-yui.html) 06:01:57 INFO - PROCESS | 1649 | RSS: Main: 255258624 06:01:57 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | Cycle 1(1): loaded http://localhost:49266/tests/dromaeo/cssquery-yui.html (next: http://localhost:49266/tests/dromaeo/cssquery-dojo.html) 06:05:00 INFO - PROCESS | 1649 | RSS: Main: 258162688 06:05:00 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | __start_tp_report 06:05:00 INFO - PROCESS | 1649 | _x_x_mozilla_page_load 06:05:00 INFO - PROCESS | 1649 | _x_x_mozilla_page_load_details 06:05:00 INFO - PROCESS | 1649 | |i|pagename|runs| 06:05:00 INFO - PROCESS | 1649 | |0;dojo.html;3432.1076520104775;3467.3412051710175;3483.9303213935714;3508.7368447366453;3525.6298088700687;5951.76192952282;6006.729697163627;6007.309159446665;6014.518838492921;6018.578699491038;5979.970100149504;6064.818055458343;6065.423784740454;6077.301110372308;6084.361142080084;5356.437574054727;5396.838094857141;5406.729663516828;5473.31583552056;5558.138488534284;5463.453654634544;5490.450954904518;5491.807786727465;5491.874165796003;5509.696966666832;5332.33345831771;5356.38401583817;5468.26178465906;5481.150421684625;5487.725613719318;5308.840734777963;5318.840434786963;5347.144456886899;5359.839204823823;5410.567154627621;5198.818041368534;5319.308489896327;5319.707416092114;5319.9202011969855;5375.408705042442;5852.356240813507;5976.193213916153;5980.470306895186;5988.461038506512;6016.699165041774;5779.508741756956;5803.883922321572;6221.937780622181;6226.968865155691;6262.718177682015;5388.649737767033;5593.356763972114;6052.001419765734;6121.959266924633;6447.935520644781;5742.913856292159;6115.938840611626;6123.693815309217;6126.203593532901;6127.87744245117;5056.974715126475;6315.905261421082;6319.652419116901;6423.4861211103;6427.196600424947;6214.974529202721;6267.655278959701;6270.090836828635;6275.905861412082;6276.560640755195;5554.361248456398;6398.840028999312;6404.775832845828;6415.807525774141;6417.871642567123;5706.343770466449;5724.713764311768;6191.9690401548605;6210.161628180138;6219.284782250099;6255.280642726145;6319.684015799284;6324.367563243639;6327.651979141099;6328.810135695937;4619.69971951822;4689.085628302517;4771.783195285249;5067.265246539231;5100.464451232641;4488.5960263576435;4495.145922274757;4521.706089104197;4556.931646025312;4581.816727330936;6065.909011364833;6085.482733967574;6120.265568131853;6120.357362476876;6121.112438696364;6366.77716279928;6405.071264666597;6426.807195784134;6435.388638079375;6441.838954026093;6010.218671572755;6088.2694076710195;6101.969490152521;6110.589135957139;6119.472088496329;5572.331320241597;5606.271184746039;5614.410486898899;5620.718964051781;5633.380328163898;6575.24384695747;6620.1724784400985;6629.635370054693;6647.501437392215;6677.866442671217;6204;6257.43683068526;6308.179936608211;6328.683565821599;6361.77733779334;6598.868022639616;6620.404163625297;6623.701933412912;6640.369164929324;6706.631135287606;6284.24589049317;6292.748290068346;6308.053791931247;6309.432151106423;6312.3056463788025;6155.692215389123;6193.318734939243;6249.437550620466;6341.587796793194;6412.9679351602945;6123.234595675541;6214.689265536615;6221.657808820558;6240.968795155995;6243.719032643451;6051.940910340761;6212.161358216764;6234.563580549318;6235.563510554218;6262.937370626418;5828.825135245949;6098.29869564988;6143.72682107623;6177.81466555986;6222.844428889314;6146.231721034871;6163.291221509584;6167.044108163242;6253.687315634291;6254.312025677263;6173.969130154321;6199.380061993765;6210.658413787104;6211.81364559064;6244.219472565929 06:05:00 INFO - PROCESS | 1649 | |1;ext.html;468.1853574779882;478.66015129258227;487.746371886619;508.48388885281446;557.7589862555814;34740.826295868515;37055.629443705555;39984.60015399845;41338;41443.585564144385;41844.58155418445;42038.36942445858;42308.36537451933;42733;42793.7860310698;7991.600419978978;8703.216710496054;9421.62313507459;9747.561359738793;9755.853662195073;8942.508162051085;9580.281478889076;9719;9802.901970980305;9836.70489885301;9816.361936474143;9861.556229969668;9864.457454839981;9865.06281903218;9870.309078364517;9791.363561368487;9831.360961537514;9835.31152819303;9843.655472058515;9884.110430061257;9674.661386851427;9728.17310528606;9729.318947673666;9746.220302375792;9789.314747967645;39756.60243397558;40009.599904000876;40071.39892901609;40184;40310.39534406986;3458.2737625098757;3536.5756109266795;3578.5169002184634;3667.6149004354693;3986.1828325193264;26226.213213603623;28938;28991.275218119506;29499;30831.691683083332;3266;3283.4254005548933;3310.139363765414;3372.2749608833974;3378;528733;536016;538506;538978.999999996;539203;30383.240418989702;33342.16618086029;57468;57508.71245643829;57940.420595793505;33890.830545847115;34718.82640586831;35113.94658160259;35179.824100879334;35186.82406588002;14932.25338733059;15059.94580379363;15063.096214226962;15081.396744130332;15091.773623395658;12657.240565566095;12737.490500380067;12831.973442124794;12833.973282137407;12854.807177892339;7690.730824421118;7701.730439434593;7765;7769.650365733555;7772.844543109106;3203.743700503954;3263.3310171414805;3264.7224985876464;3266.885659001971;3289.7498950398694;950.1543626172712;950.5104870991445;962.764122789921;964.5804075227159;1104.9060829829555;26729;30424.69575304263;30567.2358191047;30619;31024.53463198054;876.7063033883593;886.0076714080271;892.7277180460022;959.2565761534727;1028.2442404832443;15311.846881531264;15833.762493562606;15929.283182256826;15982.280797363914;16013.312872431694;735062;741938;742827;743500;745722;56871.71564142153;57358;57413.42586574164;57435.13847292294;57592;1377.366411450744;1387.1676993803637;1410.7954346619888;1413.3993052952453;1415.6814716688868;29101.7089829099;29885;29949.850250749478;30096;30464.933727319436;48205.75897120492;48280.275795863796;48415.5158448411;48484.757576211894;48630.75684621554;621058;621391;624988;625914;626018;26261.737382625928;26435;26623.46753064889;26824.195274141028;26871.328216794736;45513;45860.770696146305;46378.53621463877;46748.29877551772;46845.765771170925;39345.80327098346;39533.20933581255;39569.010774730865;39607;40593.391099134125;32722.255272984807;38696;38759.6124038756;39958.60041399665;40181.79909100436;36277.81861090783;37645.435318469696;40556.1888762229;42669.57330426656;42670.57329426666;38015;41562;41683.7915810419;41928.58071419247;42875.78562107169;31624.683753162175;32297;32491.837540812143;32569.02292931216;33222.66777332292 06:05:00 INFO - PROCESS | 1649 | |2;jquery.html;366.8605929746696;375.3150500336886;381.6755757606035;383.18381846666597;407.3279089502321;15363.539093827203;15400.30698618562;17244;19080.809191908076;21284.787152128494;16718.83281167188;20306.898465507653;20542.28102016426;20604.48488787781;20925;5429.696872750551;5839.854003649911;6076.118962750421;6078;6086.360932102132;5482.753276102565;6019.307779605336;6020.759169633209;6030.547708921827;6032.969835150818;5632.5212356949705;5951.553633477485;5954.255718035246;6007.789727359544;6016.96991515044;5584.827186290884;5729.856753581152;5951.285845698522;6000;6016.939830601704;5761.308642962829;5769.596128271022;5778.42215778423;5794.130880367937;5795.768169273224;12357.69105772354;15768.684626307524;24243.151489697953;25277.74722252791;25611.871940640365;2121.734783152106;2210.347947355518;2293.6444851048113;2294.369048511656;2921.8539073046263;9467;9548.61805527785;9755.804883902354;9854.211663066937;10003.499825008721;1589.7933268675115;1786.0533917023997;1828.2595548802756;1915.798841121676;1926.4509614759727;117607;118093;118290.40854795757;119486.80513194931;119876;11600.825987610193;11683.18217724751;11718.589849355401;11750.177487575787;11795.35125568102;14402.135871847722;14483.493077742229;14485.7827132591;14491.492797752027;14630.414783408545;8404;8655.826883462421;8675.39272250949;8755.956220218986;8802.86795698065;8588.184122508352;8685.956570217108;8687.739367818975;8832.955835220911;8866.73399798007;4447.08834688888;4521.59305662492;4528.479224889114;4581.190429780218;4585.70192937458;1863.1243315641627;1864.5711486358214;1912.502749285168;1924.681593108725;1980.6929925861514;885.4952676974063;930.265090578449;943.551812888886;961.375106180974;972.5623469438781;19997;21262.574748504943;21434.24980125688;21479.78520214809;21531.13875444996;921.161742814036;952.2762700347647;970.4322971062007;978.8238117138841;1043.4052590023614;9055.275577953747;10956.616518421817;11218.943905280421;11262.324260544394;11283.717907052389;591501;603015;614156;620377;622212;113327;119253.21120183205;121690;126679.36660316824;130642;952.5427794658602;969.9030096990385;1005.2460654509118;1016.5933626549439;1018.0582960761118;18428.539286517946;19055.428337149908;19179.32872349461;19185.32851350196;19238;55139.89720205493;56742.432575673716;57817.4218257812;58493;58834;66893.66553167203;79028;82002.58998704968;84424.15575844163;84989.57505212435;5107.923381149211;5290;7627.550765354565;7939.603019848869;8265.380096492667;8779.429337093068;10207.795844082928;11811.881881181078;13189.604311870658;13238.073334866853;11263.155263355446;11275.943620282174;11276.774464510829;11567.884321157017;11728.70678233051;11210.047145992681;11210.49552770111;11405.486753095965;11425.714357140805;11681.591144309908;9481.905180948102;9719.368241064309;11265.71835704114;11382.032527234947;11646.70883227926;6311.463525600192;7842.784368422904;7996.6401511930935;8052.033755949089;8118.918810811816;10473.738156545842;10772.461376930965;11164;11449.828252576051;11476.426178690865 06:05:00 INFO - PROCESS | 1649 | |3;mootools.html;1512.9848701512985;1550.294615949743;1718.15810252976;1718.664860352232;1740.1473278093738;7784.260495252949;8192.057913339968;8443.83112337753;9339.579718912648;9353.158215760588;7133.928660713391;9061.501617411057;9075.364724469273;9138.497382643953;9183.21942634875;2355.670206171133;2396.8681722505257;2404.2426635609813;2404.8196385271085;2410.529946660402;2400.099962514057;2403.291029146406;2427.2718184544565;2427.647991041298;2437.6587277781123;1986.1757370691146;2393.018862266471;2394.8682822444757;2402.843815152018;2416.673749043874;2375.691160149187;2378.7383387827326;2386.1171366594385;2392.2942731894045;2405.2183040511727;2381.357033600918;2386.296042667417;2395.077895010416;2398.0048279963794;2400.7719266669637;9111.635534578609;9155.404898681565;9184.954075229647;9197.908020919773;9212.49331286779;5253.9737301313635;5403.189521571757;5409.702466364349;5421.241026256288;5446.428125046853;3524.22467057247;3558.1460449491938;3567.661072198137;3613.530241068644;3619.1856832212807;1084.0893649334519;1088.5210507376728;1092.093562343253;1103.5144536403957;1103.8068338040891;12221.266723996589;12229.877701222962;12279.938600306941;12285.815712764315;12328.691782705415;3947.874855666121;4520.321951707205;4627.768611569408;4751.216049351888;4797.424309082932;10283;10359.533820978075;10363.119134873621;10366.740831479274;10398.58405663765;5387.542058924957;5399.892002160013;5406.459354064641;5407.378151512627;5415.756290966916;4380.759058251763;4542.227821270392;4758.428988521399;4880.633952453509;4970.17992031318;4038.1318016626565;4052.513698356216;4122.855700050483;4151.941254980021;4156.521999970042;1307.2352673686;1322.5635540271687;1325.6685828542863;1330.374723879775;1335.465813674538;821.9671213151527;824.468217999387;876.4784952952983;922.9030951750104;930.5021813329971;5118.692878427306;5242.790288388498;6129.1419201311855;6198.209317719169;6369.777057803048;913.6665117232295;923.0492592629603;930.8882934047957;950.8573713942964;959.1463597398321;3925.175713100281;4026.1570719219962;4044.786564030838;4075.694322925792;4161.25097482456;10859.674209773719;11267.15496337778;11267.887321126847;11269.549218031187;11293;11174.273672211442;11231;11272.830907536394;11283.887161128448;11285.322880627024;8457;8532.189442003;8571.485710857369;8576.614052367659;8608.612612432456;5770.1344798278915;5950.2264705587995;5990.400959904149;6012.068129439944;6115.082737589397;10012.64955726546;10320.948395257976;10378;10420.426876521864;10449.582016719247;8706.303495720455;9423.434593924387;10540.525676344736;10598.417087060287;10697.411642359744;6016.639001659914;6697.3637504437;6903.965480172567;7064.364207221375;7383.926160738324;8520.74437766868;8763.430377025474;8772.254358379609;8780.341474389574;8813.911860881566;6778.254392016973;7271.4182865369585;7502.624868756431;7628.923710762821;7883.526988380486;6911.447084233349;7018.929810701828;7140.500164988609;7480.401567874448;7622.58075805836;7125.1093613298335;7298.927010730037;7299.963500182677;7318.743843965436;7323.011393462028;4986.351774269322;5065.012322597058;5067.87330316745;5130.7178105204575;5205.089109405914;4554.294084416921;5076.847694569169;5170.948290517047;5230.947690523199;5242.659227150223 06:05:00 INFO - PROCESS | 1649 | |4;prototype.html;268.42556928173707;276.79932049264283;292.61374985019785;308.3986226857627;315.4668610049017;4891.877703057426;5424.80654256063;5579.191017302489;5642.774289028439;5652.8586785330335;4816.339581917741;4849.187471266666;5490.286262785832;5552;5582.190582365564;4226.830926762926;4232.449781528397;4242.7242229255;4250.362445633149;4274.850380236692;3639.3813051781262;4092.7339722918064;4155.476752179878;4277.721948073381;4285.185814695198;3661.286049220403;4116.958830411688;4171.520275168364;4173.269677806387;4210.957890421102;4163.979824942878;4198.286291330481;4226.471691038605;4228.7462752234815;4249.512670565308;3555.6088830228914;3638.890833275006;3659.304732100919;3672.173760903802;3676.540432445944;5074.82238121664;5152.192055329854;5334.199870019528;5349;5383.542398896098;4835.105505481462;4842.733649649268;4846.248831431134;4849.393825771778;4867.610591152735;5363.651362661453;5406.486383793534;5568.443155684399;5865.237519122529;5869.442402971711;3838.673712734421;3954.6158844404226;3965.524137103537;3982.78094704794;4009.0155373090506;5625.690587017753;6214.782482613132;6220.791618975244;6228.346023667495;6238.163529429414;4039.939400908989;4067.633912947849;4070.5725898780793;4070.9645177411294;4086.387041943732;3735.6824669903363;3980.4029395590314;4040.4343391925154;4045.474088368552;4100.487439070116;4497.88755281114;4524.502304746476;4755.668412844409;4761.952370478489;4788.497207793132;4714.481407045222;4939.678920870132;5945.524358051345;5996.5202783777195;6006.969965150146;1082.53992053377;1137.94171420578;1256.5350820196586;1356.8737947503548;1380.171896861895;691.7336825322287;743.4275607782085;768.6579472134846;816.7585270388976;839.5130824121994;4551.044280701024;4551.840685575989;4579.6794224403975;4649.465311489154;4726.787294571753;4386.780660966939;4886.755662216875;4921.606271498272;4991.575716064175;5134.7946082156295;3894.532656081288;4625.352450656911;4642.353858300736;4700.224462963641;4731.243001119873;2252.6258982020954;2438.914637987662;2447.8164137689387;2687.301301661582;2704.8241864278757;4731.526847315241;4884.902301953941;5295.338082739658;5327.706976116273;5345.167061457434;4386.868393948187;4644.489106198315;4779.5220477951925;5142.897142057138;5243.4232234454175;5777.537796976316;5845.09401042839;5888.352281249059;6311.842203944938;6448.226212854487;6221.06683997404;6233.438990490878;6279.874402512016;6293.307736148929;6310.747570097328;5425.267588875451;5856.648601083949;5952.285725712769;6011.519078473799;6106.1146133811235;5210.348706411699;5576.693281869536;6408.846407646668;6453.548251622341;6502.252240992347;3984.302747019202;4025.7987100645437;4045.211183819127;4048.2713111640187;4053.61490658387;5837.445442682938;6015.849603759941;6043.8186854394435;6162.537809664383;6165.969170154121;5015.598752099896;5683.9715801420725;5891.381404952418;5970.731317090828;6021.578489505692;5918.970405147947;5926.525877929669;6006.579539432198;6034.7284372202475;6039.949825338176;5114.059415835834;5254.42201357858;5447.319085114361;5735.627184233178;5825.776586916795;4962.404511458648;5174.214895860922;5916.491294719819;5996.8800623988145;6082.810188332285;5840.737166827588;5877.0605700118;5878.3239927408895;5905.40945905406;5908.704564771659 06:05:00 INFO - PROCESS | 1649 | |5;yui.html;663.7046514301138;728.8323685552323;762.3215338348871;805.6696754330726;817.5503473089799;15518.224088795558;15662.060276383425;15827.999999999985;15837.762433563506;15865.920670396661;14132.940029497802;14158.858411415882;14179.645508862284;14201.928990355034;14260.786088208659;666.410226949151;684.349867625755;816.6406781016334;828.8798124271977;836.1972506393854;859.299670768325;861.9655213791441;862.6808081010035;865.5974971638187;865.904750477447;915.1031988651126;927.8283517549241;931.501646619059;931.5668214280358;933.9673111441101;866.9176428239307;868.9522076285801;913.7532866126109;919.2508105893709;919.3426699909563;686.4542688562605;689.5345641691838;692.9653517324114;693.0678237770192;695.2977492732326;14629.707405851823;14661.04703194289;14662.926685366612;14673.559793206221;14754.188519631416;14336.56990290293;14434.566962991126;14438.422463101464;14515.85484145166;14556.708865822624;11613.535458581646;11858.3477908715;11983.161178717493;12034.63896083119;12431.37843107841;3773.3773927302236;3802.7528210666496;3825.1775868188197;3875.4380614810693;3928.135810121797;95216;114959.42520287429;119234;120680.39659801732;125623;10892.891071089347;11207.551697931991;11309.09527237819;11327.207095503236;11663.650090497298;22713;22882.65676014861;22889.88555057214;23076;23167.957441914816;7953.602319883983;7995.560244186509;8053.798655033671;8171.63227654757;8229.177082291842;4334.386934021981;4403.14138742942;4491.910161796745;4493.326001099796;4517.983453722952;3612.710983121344;3734.458503516975;3768.340540405418;3768.9446954852683;3777.490038844721;649.9146425469478;651.3031056769212;668.3650531994624;680.1701923653135;699.7760716570649;563.4534501533506;660.448525481219;661.9215662818752;677.3463607618671;691.7544271783545;8721.171488708562;9540.284478663989;9574.617015319309;9604;9648.517574121266;540.9567234621221;575.9452851979055;630.8769789890928;641.7753786174801;683.4498228925762;4290.013296941721;4320.546342634041;4342.218400687843;4687.976560117246;4718.551737584924;92610.53694731483;103674.48162759138;141350;172732;177997;89979.55010225037;92862.60706089414;142573;144843.10313793665;151522.96954060858;86794.56602716947;99598;116428.41785791017;117275.41362293305;121519.78480215262;6595.472362211108;8296.751097467086;8666.613341865272;9045.366824322235;9063.229625481908;51300.23049654333;59946;64142.472164031424;68938.31061689318;73444;77253.61373193098;85857;92655.53672231865;107632;108955.45522272338;13999.510017149758;14270.215138167085;14309.356078976263;14322.641933951734;14362;14788.556343309718;14984.250787460802;15735.44925927587;16173.419242109563;16541.759368047205;13845.376958036712;14132.15207087578;14260.607830809155;14594.562163135122;15024.924875375553;14411.351489182802;14537;14541.927290363481;14627.19550424737;14820.25898705082;13265.204087754766;13497.122687025312;14173.787393188904;14223.288835557974;14848;11262.211645184758;11287.830682539932;11604.6518604442;11656.766864662828;11972.820407693718;11626.476808543466;11741.11941604366;11772.646820595395;11819.877111674377;11926.403679815801 06:05:00 INFO - PROCESS | 1649 | __end_tp_report 06:05:00 INFO - PROCESS | 1649 | __start_cc_report 06:05:00 INFO - PROCESS | 1649 | _x_x_mozilla_cycle_collect,360 06:05:00 INFO - PROCESS | 1649 | __end_cc_report 06:05:00 INFO - PROCESS | 1649 | __startTimestamp1474376700488__endTimestamp 06:05:00 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | ------- Summary: start ------- 06:05:00 INFO - PROCESS | 1649 | Number of tests: 6 06:05:00 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | [#0] dojo.html Cycles:165 Average:5881.74 Median:6120.36 stddev:647.94 (10.6%) stddev-sans-first:620.78 06:05:00 INFO - PROCESS | 1649 | Values: 3432.1 3467.3 3483.9 3508.7 3525.6 5951.8 6006.7 6007.3 6014.5 6018.6 5980.0 6064.8 6065.4 6077.3 6084.4 5356.4 5396.8 5406.7 5473.3 5558.1 5463.5 5490.5 5491.8 5491.9 5509.7 5332.3 5356.4 5468.3 5481.2 5487.7 5308.8 5318.8 5347.1 5359.8 5410.6 5198.8 5319.3 5319.7 5319.9 5375.4 5852.4 5976.2 5980.5 5988.5 6016.7 5779.5 5803.9 6221.9 6227.0 6262.7 5388.6 5593.4 6052.0 6122.0 6447.9 5742.9 6115.9 6123.7 6126.2 6127.9 5057.0 6315.9 6319.7 6423.5 6427.2 6215.0 6267.7 6270.1 6275.9 6276.6 5554.4 6398.8 6404.8 6415.8 6417.9 5706.3 5724.7 6192.0 6210.2 6219.3 6255.3 6319.7 6324.4 6327.7 6328.8 4619.7 4689.1 4771.8 5067.3 5100.5 4488.6 4495.1 4521.7 4556.9 4581.8 6065.9 6085.5 6120.3 6120.4 6121.1 6366.8 6405.1 6426.8 6435.4 6441.8 6010.2 6088.3 6102.0 6110.6 6119.5 5572.3 5606.3 5614.4 5620.7 5633.4 6575.2 6620.2 6629.6 6647.5 6677.9 6204.0 6257.4 6308.2 6328.7 6361.8 6598.9 6620.4 6623.7 6640.4 6706.6 6284.2 6292.7 6308.1 6309.4 6312.3 6155.7 6193.3 6249.4 6341.6 6413.0 6123.2 6214.7 6221.7 6241.0 6243.7 6051.9 6212.2 6234.6 6235.6 6262.9 5828.8 6098.3 6143.7 6177.8 6222.8 6146.2 6163.3 6167.0 6253.7 6254.3 6174.0 6199.4 6210.7 6211.8 6244.2 06:05:00 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | [#1] ext.html Cycles:180 Average:74380.05 Median:40965.70 stddev:171764.22 (419.3%) stddev-sans-first:172156.41 06:05:00 INFO - PROCESS | 1649 | Values: 468.2 478.7 487.7 508.5 557.8 34740.8 37055.6 39984.6 41338.0 41443.6 41844.6 42038.4 42308.4 42733.0 42793.8 7991.6 8703.2 9421.6 9747.6 9755.9 8942.5 9580.3 9719.0 9802.9 9836.7 9816.4 9861.6 9864.5 9865.1 9870.3 9791.4 9831.4 9835.3 9843.7 9884.1 9674.7 9728.2 9729.3 9746.2 9789.3 39756.6 40009.6 40071.4 40184.0 40310.4 3458.3 3536.6 3578.5 3667.6 3986.2 26226.2 28938.0 28991.3 29499.0 30831.7 3266.0 3283.4 3310.1 3372.3 3378.0 528733.0 536016.0 538506.0 538979.0 539203.0 30383.2 33342.2 57468.0 57508.7 57940.4 33890.8 34718.8 35113.9 35179.8 35186.8 14932.3 15059.9 15063.1 15081.4 15091.8 12657.2 12737.5 12832.0 12834.0 12854.8 7690.7 7701.7 7765.0 7769.7 7772.8 3203.7 3263.3 3264.7 3266.9 3289.7 950.2 950.5 962.8 964.6 1104.9 26729.0 30424.7 30567.2 30619.0 31024.5 876.7 886.0 892.7 959.3 1028.2 15311.8 15833.8 15929.3 15982.3 16013.3 735062.0 741938.0 742827.0 743500.0 745722.0 56871.7 57358.0 57413.4 57435.1 57592.0 1377.4 1387.2 1410.8 1413.4 1415.7 29101.7 29885.0 29949.9 30096.0 30464.9 48205.8 48280.3 48415.5 48484.8 48630.8 621058.0 621391.0 624988.0 625914.0 626018.0 26261.7 26435.0 26623.5 26824.2 26871.3 45513.0 45860.8 46378.5 46748.3 46845.8 39345.8 39533.2 39569.0 39607.0 40593.4 32722.3 38696.0 38759.6 39958.6 40181.8 36277.8 37645.4 40556.2 42669.6 42670.6 38015.0 41562.0 41683.8 41928.6 42875.8 31624.7 32297.0 32491.8 32569.0 33222.7 06:05:00 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | [#2] jquery.html Cycles:180 Average:35119.60 Median:1644.36 stddev:101732.64 (6186.8%) stddev-sans-first:101984.56 06:05:00 INFO - PROCESS | 1649 | Values: 366.9 375.3 381.7 383.2 407.3 15363.5 15400.3 17244.0 19080.8 21284.8 16718.8 20306.9 20542.3 20604.5 20925.0 5429.7 5839.9 6076.1 6078.0 6086.4 5482.8 6019.3 6020.8 6030.5 6033.0 5632.5 5951.6 5954.3 6007.8 6017.0 5584.8 5729.9 5951.3 6000.0 6016.9 5761.3 5769.6 5778.4 5794.1 5795.8 12357.7 15768.7 24243.2 25277.7 25611.9 2121.7 2210.3 2293.6 2294.4 2921.9 9467.0 9548.6 9755.8 9854.2 10003.5 1589.8 1786.1 1828.3 1915.8 1926.5 117607.0 118093.0 118290.4 119486.8 119876.0 11600.8 11683.2 11718.6 11750.2 11795.4 14402.1 14483.5 14485.8 14491.5 14630.4 8404.0 8655.8 8675.4 8756.0 8802.9 8588.2 8686.0 8687.7 8833.0 8866.7 4447.1 4521.6 4528.5 4581.2 4585.7 1863.1 1864.6 1912.5 1924.7 1980.7 885.5 930.3 943.6 961.4 972.6 19997.0 21262.6 21434.2 21479.8 21531.1 921.2 952.3 970.4 978.8 1043.4 9055.3 10956.6 11218.9 11262.3 11283.7 591501.0 603015.0 614156.0 620377.0 622212.0 113327.0 119253.2 121690.0 126679.4 130642.0 952.5 969.9 1005.2 1016.6 1018.1 18428.5 19055.4 19179.3 19185.3 19238.0 55139.9 56742.4 57817.4 58493.0 58834.0 66893.7 79028.0 82002.6 84424.2 84989.6 5107.9 5290.0 7627.6 7939.6 8265.4 8779.4 10207.8 11811.9 13189.6 13238.1 11263.2 11275.9 11276.8 11567.9 11728.7 11210.0 11210.5 11405.5 11425.7 11681.6 9481.9 9719.4 11265.7 11382.0 11646.7 6311.5 7842.8 7996.6 8052.0 8118.9 10473.7 10772.5 11164.0 11449.8 11476.4 06:05:00 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | [#3] mootools.html Cycles:180 Average:5815.81 Median:4777.93 stddev:3320.59 (69.5%) stddev-sans-first:3314.16 06:05:00 INFO - PROCESS | 1649 | Values: 1513.0 1550.3 1718.2 1718.7 1740.1 7784.3 8192.1 8443.8 9339.6 9353.2 7133.9 9061.5 9075.4 9138.5 9183.2 2355.7 2396.9 2404.2 2404.8 2410.5 2400.1 2403.3 2427.3 2427.6 2437.7 1986.2 2393.0 2394.9 2402.8 2416.7 2375.7 2378.7 2386.1 2392.3 2405.2 2381.4 2386.3 2395.1 2398.0 2400.8 9111.6 9155.4 9185.0 9197.9 9212.5 5254.0 5403.2 5409.7 5421.2 5446.4 3524.2 3558.1 3567.7 3613.5 3619.2 1084.1 1088.5 1092.1 1103.5 1103.8 12221.3 12229.9 12279.9 12285.8 12328.7 3947.9 4520.3 4627.8 4751.2 4797.4 10283.0 10359.5 10363.1 10366.7 10398.6 5387.5 5399.9 5406.5 5407.4 5415.8 4380.8 4542.2 4758.4 4880.6 4970.2 4038.1 4052.5 4122.9 4151.9 4156.5 1307.2 1322.6 1325.7 1330.4 1335.5 822.0 824.5 876.5 922.9 930.5 5118.7 5242.8 6129.1 6198.2 6369.8 913.7 923.0 930.9 950.9 959.1 3925.2 4026.2 4044.8 4075.7 4161.3 10859.7 11267.2 11267.9 11269.5 11293.0 11174.3 11231.0 11272.8 11283.9 11285.3 8457.0 8532.2 8571.5 8576.6 8608.6 5770.1 5950.2 5990.4 6012.1 6115.1 10012.6 10320.9 10378.0 10420.4 10449.6 8706.3 9423.4 10540.5 10598.4 10697.4 6016.6 6697.4 6904.0 7064.4 7383.9 8520.7 8763.4 8772.3 8780.3 8813.9 6778.3 7271.4 7502.6 7628.9 7883.5 6911.4 7018.9 7140.5 7480.4 7622.6 7125.1 7298.9 7300.0 7318.7 7323.0 4986.4 5065.0 5067.9 5130.7 5205.1 4554.3 5076.8 5170.9 5230.9 5242.7 06:05:00 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | [#4] prototype.html Cycles:180 Average:4630.93 Median:4906.74 stddev:1470.98 (30.0%) stddev-sans-first:1438.20 06:05:00 INFO - PROCESS | 1649 | Values: 268.4 276.8 292.6 308.4 315.5 4891.9 5424.8 5579.2 5642.8 5652.9 4816.3 4849.2 5490.3 5552.0 5582.2 4226.8 4232.4 4242.7 4250.4 4274.9 3639.4 4092.7 4155.5 4277.7 4285.2 3661.3 4117.0 4171.5 4173.3 4211.0 4164.0 4198.3 4226.5 4228.7 4249.5 3555.6 3638.9 3659.3 3672.2 3676.5 5074.8 5152.2 5334.2 5349.0 5383.5 4835.1 4842.7 4846.2 4849.4 4867.6 5363.7 5406.5 5568.4 5865.2 5869.4 3838.7 3954.6 3965.5 3982.8 4009.0 5625.7 6214.8 6220.8 6228.3 6238.2 4039.9 4067.6 4070.6 4071.0 4086.4 3735.7 3980.4 4040.4 4045.5 4100.5 4497.9 4524.5 4755.7 4762.0 4788.5 4714.5 4939.7 5945.5 5996.5 6007.0 1082.5 1137.9 1256.5 1356.9 1380.2 691.7 743.4 768.7 816.8 839.5 4551.0 4551.8 4579.7 4649.5 4726.8 4386.8 4886.8 4921.6 4991.6 5134.8 3894.5 4625.4 4642.4 4700.2 4731.2 2252.6 2438.9 2447.8 2687.3 2704.8 4731.5 4884.9 5295.3 5327.7 5345.2 4386.9 4644.5 4779.5 5142.9 5243.4 5777.5 5845.1 5888.4 6311.8 6448.2 6221.1 6233.4 6279.9 6293.3 6310.7 5425.3 5856.6 5952.3 6011.5 6106.1 5210.3 5576.7 6408.8 6453.5 6502.3 3984.3 4025.8 4045.2 4048.3 4053.6 5837.4 6015.8 6043.8 6162.5 6166.0 5015.6 5684.0 5891.4 5970.7 6021.6 5919.0 5926.5 6006.6 6034.7 6039.9 5114.1 5254.4 5447.3 5735.6 5825.8 4962.4 5174.2 5916.5 5996.9 6082.8 5840.7 5877.1 5878.3 5905.4 5908.7 06:05:00 INFO - PROCESS | 1649 | 06:05:00 INFO - PROCESS | 1649 | [#5] yui.html Cycles:180 Average:24837.42 Median:3775.43 stddev:39517.81 (1046.7%) stddev-sans-first:39586.99 06:05:00 INFO - PROCESS | 1649 | Values: 663.7 728.8 762.3 805.7 817.6 15518.2 15662.1 15828.0 15837.8 15865.9 14132.9 14158.9 14179.6 14201.9 14260.8 666.4 684.3 816.6 828.9 836.2 859.3 862.0 862.7 865.6 865.9 915.1 927.8 931.5 931.6 934.0 866.9 869.0 913.8 919.3 919.3 686.5 689.5 693.0 693.1 695.3 14629.7 14661.0 14662.9 14673.6 14754.2 14336.6 14434.6 14438.4 14515.9 14556.7 11613.5 11858.3 11983.2 12034.6 12431.4 3773.4 3802.8 3825.2 3875.4 3928.1 95216.0 114959.4 119234.0 120680.4 125623.0 10892.9 11207.6 11309.1 11327.2 11663.7 22713.0 22882.7 22889.9 23076.0 23168.0 7953.6 7995.6 8053.8 8171.6 8229.2 4334.4 4403.1 4491.9 4493.3 4518.0 3612.7 3734.5 3768.3 3768.9 3777.5 649.9 651.3 668.4 680.2 699.8 563.5 660.4 661.9 677.3 691.8 8721.2 9540.3 9574.6 9604.0 9648.5 541.0 575.9 630.9 641.8 683.4 4290.0 4320.5 4342.2 4688.0 4718.6 92610.5 103674.5 141350.0 172732.0 177997.0 89979.6 92862.6 142573.0 144843.1 151523.0 86794.6 99598.0 116428.4 117275.4 121519.8 6595.5 8296.8 8666.6 9045.4 9063.2 51300.2 59946.0 64142.5 68938.3 73444.0 77253.6 85857.0 92655.5 107632.0 108955.5 13999.5 14270.2 14309.4 14322.6 14362.0 14788.6 14984.3 15735.4 16173.4 16541.8 13845.4 14132.2 14260.6 14594.6 15024.9 14411.4 14537.0 14541.9 14627.2 14820.3 13265.2 13497.1 14173.8 14223.3 14848.0 11262.2 11287.8 11604.7 11656.8 11972.8 11626.5 11741.1 11772.6 11819.9 11926.4 06:05:00 INFO - PROCESS | 1649 | -------- Summary: end -------- 06:05:00 INFO - PROCESS | 1649 | 06:05:01 INFO - TEST-INFO | 1649: exit 0 06:05:01 INFO - TEST-OK | dromaeo_css | took 1114062ms 06:05:01 INFO - TEST-START | kraken 06:05:01 INFO - operating with platform_type : mac_ 06:05:01 INFO - Initialising browser for kraken test... 06:05:01 INFO - TEST-INFO | started process 1660 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/tmp7u0Hcc/profile http://localhost:49266/getInfo.html) 06:05:03 INFO - PROCESS | 1660 | __metrics Screen width/height:1600/1200 06:05:03 INFO - PROCESS | 1660 | colorDepth:24 06:05:03 INFO - PROCESS | 1660 | Browser inner width/height: 1024/689 06:05:03 INFO - PROCESS | 1660 | __metrics 06:05:03 ERROR - PROCESS | 1660 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 06:05:04 INFO - TEST-INFO | 1660: exit 0 06:05:04 INFO - Browser initialized. 06:05:04 INFO - Running cycle 1/1 for kraken test... 06:05:04 INFO - TEST-INFO | started process 1662 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/tmp7u0Hcc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:05:16 INFO - PROCESS | 1662 | RSS: Main: 224862208 06:05:16 INFO - PROCESS | 1662 | 06:05:19 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49266/tests/kraken/driver.html?testName=audio-beat-detection) 06:05:20 INFO - PROCESS | 1662 | RSS: Main: 237391872 06:05:20 INFO - PROCESS | 1662 | 06:05:22 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49266/tests/kraken/driver.html?testName=audio-dft) 06:05:23 INFO - PROCESS | 1662 | RSS: Main: 244813824 06:05:23 INFO - PROCESS | 1662 | 06:05:26 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49266/tests/kraken/driver.html?testName=audio-fft) 06:05:27 INFO - PROCESS | 1662 | RSS: Main: 248672256 06:05:27 INFO - PROCESS | 1662 | 06:05:29 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49266/tests/kraken/driver.html?testName=audio-oscillator) 06:05:29 INFO - PROCESS | 1662 | RSS: Main: 249110528 06:05:29 INFO - PROCESS | 1662 | 06:05:31 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49266/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:05:32 INFO - PROCESS | 1662 | RSS: Main: 249044992 06:05:32 INFO - PROCESS | 1662 | 06:05:35 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49266/tests/kraken/driver.html?testName=imaging-darkroom) 06:05:35 INFO - PROCESS | 1662 | RSS: Main: 249630720 06:05:35 INFO - PROCESS | 1662 | 06:05:39 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49266/tests/kraken/driver.html?testName=imaging-desaturate) 06:05:39 INFO - PROCESS | 1662 | RSS: Main: 251101184 06:05:39 INFO - PROCESS | 1662 | 06:05:42 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49266/tests/kraken/driver.html?testName=json-parse-financial) 06:05:43 INFO - PROCESS | 1662 | RSS: Main: 251265024 06:05:43 INFO - PROCESS | 1662 | 06:05:45 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49266/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:05:45 INFO - PROCESS | 1662 | RSS: Main: 250769408 06:05:45 INFO - PROCESS | 1662 | 06:05:47 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49266/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:05:48 INFO - PROCESS | 1662 | RSS: Main: 250732544 06:05:48 INFO - PROCESS | 1662 | 06:05:50 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49266/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:05:51 INFO - PROCESS | 1662 | RSS: Main: 250744832 06:05:51 INFO - PROCESS | 1662 | 06:05:54 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49266/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:05:55 INFO - PROCESS | 1662 | RSS: Main: 251072512 06:05:55 INFO - PROCESS | 1662 | 06:05:57 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49266/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:05:58 INFO - PROCESS | 1662 | RSS: Main: 250880000 06:05:58 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | Cycle 1(1): loaded http://localhost:49266/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49266/tests/kraken/driver.html?testName=ai-astar) 06:06:00 INFO - PROCESS | 1662 | RSS: Main: 252661760 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | __start_tp_report 06:06:00 INFO - PROCESS | 1662 | _x_x_mozilla_page_load 06:06:00 INFO - PROCESS | 1662 | _x_x_mozilla_page_load_details 06:06:00 INFO - PROCESS | 1662 | |i|pagename|runs| 06:06:00 INFO - PROCESS | 1662 | |0;ai-astar;105;117;118;116;118;117;116;116;117;119 06:06:00 INFO - PROCESS | 1662 | |1;audio-beat-detection;163;104;142;176;127;110;112;115;176;141 06:06:00 INFO - PROCESS | 1662 | |2;audio-dft;196;198;196;195;195;190;197;201;205;196 06:06:00 INFO - PROCESS | 1662 | |3;audio-fft;80;60;59;88;59;61;58;61;76;59 06:06:00 INFO - PROCESS | 1662 | |4;audio-oscillator;82;71;90;72;70;67;87;70;71;87 06:06:00 INFO - PROCESS | 1662 | |5;imaging-gaussian-blur;130;132;88;86;87;85;102;81;84;99 06:06:00 INFO - PROCESS | 1662 | |6;imaging-darkroom;110;132;153;117;150;152;107;150;152;108 06:06:00 INFO - PROCESS | 1662 | |7;imaging-desaturate;94;93;90;145;143;89;121;101;76;82 06:06:00 INFO - PROCESS | 1662 | |8;json-parse-financial;45;58;78;52;58;82;90;91;92;53 06:06:00 INFO - PROCESS | 1662 | |9;json-stringify-tinderbox;68;71;73;80;77;73;94;104;105;104 06:06:00 INFO - PROCESS | 1662 | |10;stanford-crypto-aes;81;77;85;73;105;101;106;84;94;95 06:06:00 INFO - PROCESS | 1662 | |11;stanford-crypto-ccm;158;162;145;135;141;143;139;143;176;140 06:06:00 INFO - PROCESS | 1662 | |12;stanford-crypto-pbkdf2;163;164;166;165;163;167;165;167;166;167 06:06:00 INFO - PROCESS | 1662 | |13;stanford-crypto-sha256-iterative;63;67;69;66;69;65;67;67;68;69 06:06:00 INFO - PROCESS | 1662 | __end_tp_report 06:06:00 INFO - PROCESS | 1662 | __start_cc_report 06:06:00 INFO - PROCESS | 1662 | _x_x_mozilla_cycle_collect,964 06:06:00 INFO - PROCESS | 1662 | __end_cc_report 06:06:00 INFO - PROCESS | 1662 | __startTimestamp1474376760416__endTimestamp 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | ------- Summary: start ------- 06:06:00 INFO - PROCESS | 1662 | Number of tests: 14 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#0] ai-astar Cycles:10 Average:115.90 Median:117.00 stddev:3.96 (3.4%) stddev-sans-first:1.05 06:06:00 INFO - PROCESS | 1662 | Values: 105.0 117.0 118.0 116.0 118.0 117.0 116.0 116.0 117.0 119.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#1] audio-beat-detection Cycles:10 Average:136.60 Median:141.50 stddev:27.46 (19.4%) stddev-sans-first:27.41 06:06:00 INFO - PROCESS | 1662 | Values: 163.0 104.0 142.0 176.0 127.0 110.0 112.0 115.0 176.0 141.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#2] audio-dft Cycles:10 Average:196.90 Median:196.50 stddev:3.96 (2.0%) stddev-sans-first:4.18 06:06:00 INFO - PROCESS | 1662 | Values: 196.0 198.0 196.0 195.0 195.0 190.0 197.0 201.0 205.0 196.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#3] audio-fft Cycles:10 Average:66.10 Median:61.00 stddev:10.94 (17.9%) stddev-sans-first:10.38 06:06:00 INFO - PROCESS | 1662 | Values: 80.0 60.0 59.0 88.0 59.0 61.0 58.0 61.0 76.0 59.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#4] audio-oscillator Cycles:10 Average:76.70 Median:77.00 stddev:8.74 (11.4%) stddev-sans-first:9.06 06:06:00 INFO - PROCESS | 1662 | Values: 82.0 71.0 90.0 72.0 70.0 67.0 87.0 70.0 71.0 87.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#5] imaging-gaussian-blur Cycles:10 Average:97.40 Median:85.50 stddev:18.89 (22.1%) stddev-sans-first:15.94 06:06:00 INFO - PROCESS | 1662 | Values: 130.0 132.0 88.0 86.0 87.0 85.0 102.0 81.0 84.0 99.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#6] imaging-darkroom Cycles:10 Average:133.10 Median:150.00 stddev:20.51 (13.7%) stddev-sans-first:19.98 06:06:00 INFO - PROCESS | 1662 | Values: 110.0 132.0 153.0 117.0 150.0 152.0 107.0 150.0 152.0 108.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#7] imaging-desaturate Cycles:10 Average:103.40 Median:85.50 stddev:24.51 (28.7%) stddev-sans-first:25.76 06:06:00 INFO - PROCESS | 1662 | Values: 94.0 93.0 90.0 145.0 143.0 89.0 121.0 101.0 76.0 82.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#8] json-parse-financial Cycles:10 Average:69.90 Median:80.00 stddev:18.44 (23.0%) stddev-sans-first:17.21 06:06:00 INFO - PROCESS | 1662 | Values: 45.0 58.0 78.0 52.0 58.0 82.0 90.0 91.0 92.0 53.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#9] json-stringify-tinderbox Cycles:10 Average:84.90 Median:73.00 stddev:15.15 (20.7%) stddev-sans-first:14.78 06:06:00 INFO - PROCESS | 1662 | Values: 68.0 71.0 73.0 80.0 77.0 73.0 94.0 104.0 105.0 104.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#10] stanford-crypto-aes Cycles:10 Average:90.10 Median:82.50 stddev:11.75 (14.2%) stddev-sans-first:11.99 06:06:00 INFO - PROCESS | 1662 | Values: 81.0 77.0 85.0 73.0 105.0 101.0 106.0 84.0 94.0 95.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#11] stanford-crypto-ccm Cycles:10 Average:148.20 Median:144.00 stddev:12.92 (9.0%) stddev-sans-first:13.20 06:06:00 INFO - PROCESS | 1662 | Values: 158.0 162.0 145.0 135.0 141.0 143.0 139.0 143.0 176.0 140.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:165.30 Median:166.00 stddev:1.57 (0.9%) stddev-sans-first:1.42 06:06:00 INFO - PROCESS | 1662 | Values: 163.0 164.0 166.0 165.0 163.0 167.0 165.0 167.0 166.0 167.0 06:06:00 INFO - PROCESS | 1662 | 06:06:00 INFO - PROCESS | 1662 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.00 Median:67.50 stddev:1.94 (2.9%) stddev-sans-first:1.42 06:06:00 INFO - PROCESS | 1662 | Values: 63.0 67.0 69.0 66.0 69.0 65.0 67.0 67.0 68.0 69.0 06:06:00 INFO - PROCESS | 1662 | -------- Summary: end -------- 06:06:00 INFO - PROCESS | 1662 | 06:06:01 INFO - TEST-INFO | 1662: exit 0 06:06:01 INFO - TEST-OK | kraken | took 60144ms 06:06:01 INFO - SUITE-END | took 1174s 06:06:01 INFO - Completed test suite (00:19:34) 06:06:01 INFO - javascript benchmark 06:06:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7366.014332688753, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3432.1076520104775, 3467.3412051710175, 3483.9303213935714, 3508.7368447366453, 3525.6298088700687, 5951.76192952282, 6006.729697163627, 6007.309159446665, 6014.518838492921, 6018.578699491038, 5979.970100149504, 6064.818055458343, 6065.423784740454, 6077.301110372308, 6084.361142080084, 5356.437574054727, 5396.838094857141, 5406.729663516828, 5473.31583552056, 5558.138488534284, 5463.453654634544, 5490.450954904518, 5491.807786727465, 5491.874165796003, 5509.696966666832, 5332.33345831771, 5356.38401583817, 5468.26178465906, 5481.150421684625, 5487.725613719318, 5308.840734777963, 5318.840434786963, 5347.144456886899, 5359.839204823823, 5410.567154627621, 5198.818041368534, 5319.308489896327, 5319.707416092114, 5319.9202011969855, 5375.408705042442, 5852.356240813507, 5976.193213916153, 5980.470306895186, 5988.461038506512, 6016.699165041774, 5779.508741756956, 5803.883922321572, 6221.937780622181, 6226.968865155691, 6262.718177682015, 5388.649737767033, 5593.356763972114, 6052.001419765734, 6121.959266924633, 6447.935520644781, 5742.913856292159, 6115.938840611626, 6123.693815309217, 6126.203593532901, 6127.87744245117, 5056.974715126475, 6315.905261421082, 6319.652419116901, 6423.4861211103, 6427.196600424947, 6214.974529202721, 6267.655278959701, 6270.090836828635, 6275.905861412082, 6276.560640755195, 5554.361248456398, 6398.840028999312, 6404.775832845828, 6415.807525774141, 6417.871642567123, 5706.343770466449, 5724.713764311768, 6191.9690401548605, 6210.161628180138, 6219.284782250099, 6255.280642726145, 6319.684015799284, 6324.367563243639, 6327.651979141099, 6328.810135695937, 4619.69971951822, 4689.085628302517, 4771.783195285249, 5067.265246539231, 5100.464451232641, 4488.5960263576435, 4495.145922274757, 4521.706089104197, 4556.931646025312, 4581.816727330936, 6065.909011364833, 6085.482733967574, 6120.265568131853, 6120.357362476876, 6121.112438696364, 6366.77716279928, 6405.071264666597, 6426.807195784134, 6435.388638079375, 6441.838954026093, 6010.218671572755, 6088.2694076710195, 6101.969490152521, 6110.589135957139, 6119.472088496329, 5572.331320241597, 5606.271184746039, 5614.410486898899, 5620.718964051781, 5633.380328163898, 6575.24384695747, 6620.1724784400985, 6629.635370054693, 6647.501437392215, 6677.866442671217, 6204.0, 6257.43683068526, 6308.179936608211, 6328.683565821599, 6361.77733779334, 6598.868022639616, 6620.404163625297, 6623.701933412912, 6640.369164929324, 6706.631135287606, 6284.24589049317, 6292.748290068346, 6308.053791931247, 6309.432151106423, 6312.3056463788025, 6155.692215389123, 6193.318734939243, 6249.437550620466, 6341.587796793194, 6412.9679351602945, 6123.234595675541, 6214.689265536615, 6221.657808820558, 6240.968795155995, 6243.719032643451, 6051.940910340761, 6212.161358216764, 6234.563580549318, 6235.563510554218, 6262.937370626418, 5828.825135245949, 6098.29869564988, 6143.72682107623, 6177.81466555986, 6222.844428889314, 6146.231721034871, 6163.291221509584, 6167.044108163242, 6253.687315634291, 6254.312025677263, 6173.969130154321, 6199.380061993765, 6210.658413787104, 6211.81364559064, 6244.219472565929], "value": 5841.542272241627, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [468.1853574779882, 478.66015129258227, 487.746371886619, 508.48388885281446, 557.7589862555814, 34740.826295868515, 37055.629443705555, 39984.60015399845, 41338.0, 41443.585564144385, 41844.58155418445, 42038.36942445858, 42308.36537451933, 42733.0, 42793.7860310698, 7991.600419978978, 8703.216710496054, 9421.62313507459, 9747.561359738793, 9755.853662195073, 8942.508162051085, 9580.281478889076, 9719.0, 9802.901970980305, 9836.70489885301, 9816.361936474143, 9861.556229969668, 9864.457454839981, 9865.06281903218, 9870.309078364517, 9791.363561368487, 9831.360961537514, 9835.31152819303, 9843.655472058515, 9884.110430061257, 9674.661386851427, 9728.17310528606, 9729.318947673666, 9746.220302375792, 9789.314747967645, 39756.60243397558, 40009.599904000876, 40071.39892901609, 40184.0, 40310.39534406986, 3458.2737625098757, 3536.5756109266795, 3578.5169002184634, 3667.6149004354693, 3986.1828325193264, 26226.213213603623, 28938.0, 28991.275218119506, 29499.0, 30831.691683083332, 3266.0, 3283.4254005548933, 3310.139363765414, 3372.2749608833974, 3378.0, 528733.0, 536016.0, 538506.0, 538978.999999996, 539203.0, 30383.240418989702, 33342.16618086029, 57468.0, 57508.71245643829, 57940.420595793505, 33890.830545847115, 34718.82640586831, 35113.94658160259, 35179.824100879334, 35186.82406588002, 14932.25338733059, 15059.94580379363, 15063.096214226962, 15081.396744130332, 15091.773623395658, 12657.240565566095, 12737.490500380067, 12831.973442124794, 12833.973282137407, 12854.807177892339, 7690.730824421118, 7701.730439434593, 7765.0, 7769.650365733555, 7772.844543109106, 3203.743700503954, 3263.3310171414805, 3264.7224985876464, 3266.885659001971, 3289.7498950398694, 950.1543626172712, 950.5104870991445, 962.764122789921, 964.5804075227159, 1104.9060829829555, 26729.0, 30424.69575304263, 30567.2358191047, 30619.0, 31024.53463198054, 876.7063033883593, 886.0076714080271, 892.7277180460022, 959.2565761534727, 1028.2442404832443, 15311.846881531264, 15833.762493562606, 15929.283182256826, 15982.280797363914, 16013.312872431694, 735062.0, 741938.0, 742827.0, 743500.0, 745722.0, 56871.71564142153, 57358.0, 57413.42586574164, 57435.13847292294, 57592.0, 1377.366411450744, 1387.1676993803637, 1410.7954346619888, 1413.3993052952453, 1415.6814716688868, 29101.7089829099, 29885.0, 29949.850250749478, 30096.0, 30464.933727319436, 48205.75897120492, 48280.275795863796, 48415.5158448411, 48484.757576211894, 48630.75684621554, 621058.0, 621391.0, 624988.0, 625914.0, 626018.0, 26261.737382625928, 26435.0, 26623.46753064889, 26824.195274141028, 26871.328216794736, 45513.0, 45860.770696146305, 46378.53621463877, 46748.29877551772, 46845.765771170925, 39345.80327098346, 39533.20933581255, 39569.010774730865, 39607.0, 40593.391099134125, 32722.255272984807, 38696.0, 38759.6124038756, 39958.60041399665, 40181.79909100436, 36277.81861090783, 37645.435318469696, 40556.1888762229, 42669.57330426656, 42670.57329426666, 38015.0, 41562.0, 41683.7915810419, 41928.58071419247, 42875.78562107169, 31624.683753162175, 32297.0, 32491.837540812143, 32569.02292931216, 33222.66777332292], "value": 18930.55798820413, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [366.8605929746696, 375.3150500336886, 381.6755757606035, 383.18381846666597, 407.3279089502321, 15363.539093827203, 15400.30698618562, 17244.0, 19080.809191908076, 21284.787152128494, 16718.83281167188, 20306.898465507653, 20542.28102016426, 20604.48488787781, 20925.0, 5429.696872750551, 5839.854003649911, 6076.118962750421, 6078.0, 6086.360932102132, 5482.753276102565, 6019.307779605336, 6020.759169633209, 6030.547708921827, 6032.969835150818, 5632.5212356949705, 5951.553633477485, 5954.255718035246, 6007.789727359544, 6016.96991515044, 5584.827186290884, 5729.856753581152, 5951.285845698522, 6000.0, 6016.939830601704, 5761.308642962829, 5769.596128271022, 5778.42215778423, 5794.130880367937, 5795.768169273224, 12357.69105772354, 15768.684626307524, 24243.151489697953, 25277.74722252791, 25611.871940640365, 2121.734783152106, 2210.347947355518, 2293.6444851048113, 2294.369048511656, 2921.8539073046263, 9467.0, 9548.61805527785, 9755.804883902354, 9854.211663066937, 10003.499825008721, 1589.7933268675115, 1786.0533917023997, 1828.2595548802756, 1915.798841121676, 1926.4509614759727, 117607.0, 118093.0, 118290.40854795757, 119486.80513194931, 119876.0, 11600.825987610193, 11683.18217724751, 11718.589849355401, 11750.177487575787, 11795.35125568102, 14402.135871847722, 14483.493077742229, 14485.7827132591, 14491.492797752027, 14630.414783408545, 8404.0, 8655.826883462421, 8675.39272250949, 8755.956220218986, 8802.86795698065, 8588.184122508352, 8685.956570217108, 8687.739367818975, 8832.955835220911, 8866.73399798007, 4447.08834688888, 4521.59305662492, 4528.479224889114, 4581.190429780218, 4585.70192937458, 1863.1243315641627, 1864.5711486358214, 1912.502749285168, 1924.681593108725, 1980.6929925861514, 885.4952676974063, 930.265090578449, 943.551812888886, 961.375106180974, 972.5623469438781, 19997.0, 21262.574748504943, 21434.24980125688, 21479.78520214809, 21531.13875444996, 921.161742814036, 952.2762700347647, 970.4322971062007, 978.8238117138841, 1043.4052590023614, 9055.275577953747, 10956.616518421817, 11218.943905280421, 11262.324260544394, 11283.717907052389, 591501.0, 603015.0, 614156.0, 620377.0, 622212.0, 113327.0, 119253.21120183205, 121690.0, 126679.36660316824, 130642.0, 952.5427794658602, 969.9030096990385, 1005.2460654509118, 1016.5933626549439, 1018.0582960761118, 18428.539286517946, 19055.428337149908, 19179.32872349461, 19185.32851350196, 19238.0, 55139.89720205493, 56742.432575673716, 57817.4218257812, 58493.0, 58834.0, 66893.66553167203, 79028.0, 82002.58998704968, 84424.15575844163, 84989.57505212435, 5107.923381149211, 5290.0, 7627.550765354565, 7939.603019848869, 8265.380096492667, 8779.429337093068, 10207.795844082928, 11811.881881181078, 13189.604311870658, 13238.073334866853, 11263.155263355446, 11275.943620282174, 11276.774464510829, 11567.884321157017, 11728.70678233051, 11210.047145992681, 11210.49552770111, 11405.486753095965, 11425.714357140805, 11681.591144309908, 9481.905180948102, 9719.368241064309, 11265.71835704114, 11382.032527234947, 11646.70883227926, 6311.463525600192, 7842.784368422904, 7996.6401511930935, 8052.033755949089, 8118.918810811816, 10473.738156545842, 10772.461376930965, 11164.0, 11449.828252576051, 11476.426178690865], "value": 9453.305315243355, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1512.9848701512985, 1550.294615949743, 1718.15810252976, 1718.664860352232, 1740.1473278093738, 7784.260495252949, 8192.057913339968, 8443.83112337753, 9339.579718912648, 9353.158215760588, 7133.928660713391, 9061.501617411057, 9075.364724469273, 9138.497382643953, 9183.21942634875, 2355.670206171133, 2396.8681722505257, 2404.2426635609813, 2404.8196385271085, 2410.529946660402, 2400.099962514057, 2403.291029146406, 2427.2718184544565, 2427.647991041298, 2437.6587277781123, 1986.1757370691146, 2393.018862266471, 2394.8682822444757, 2402.843815152018, 2416.673749043874, 2375.691160149187, 2378.7383387827326, 2386.1171366594385, 2392.2942731894045, 2405.2183040511727, 2381.357033600918, 2386.296042667417, 2395.077895010416, 2398.0048279963794, 2400.7719266669637, 9111.635534578609, 9155.404898681565, 9184.954075229647, 9197.908020919773, 9212.49331286779, 5253.9737301313635, 5403.189521571757, 5409.702466364349, 5421.241026256288, 5446.428125046853, 3524.22467057247, 3558.1460449491938, 3567.661072198137, 3613.530241068644, 3619.1856832212807, 1084.0893649334519, 1088.5210507376728, 1092.093562343253, 1103.5144536403957, 1103.8068338040891, 12221.266723996589, 12229.877701222962, 12279.938600306941, 12285.815712764315, 12328.691782705415, 3947.874855666121, 4520.321951707205, 4627.768611569408, 4751.216049351888, 4797.424309082932, 10283.0, 10359.533820978075, 10363.119134873621, 10366.740831479274, 10398.58405663765, 5387.542058924957, 5399.892002160013, 5406.459354064641, 5407.378151512627, 5415.756290966916, 4380.759058251763, 4542.227821270392, 4758.428988521399, 4880.633952453509, 4970.17992031318, 4038.1318016626565, 4052.513698356216, 4122.855700050483, 4151.941254980021, 4156.521999970042, 1307.2352673686, 1322.5635540271687, 1325.6685828542863, 1330.374723879775, 1335.465813674538, 821.9671213151527, 824.468217999387, 876.4784952952983, 922.9030951750104, 930.5021813329971, 5118.692878427306, 5242.790288388498, 6129.1419201311855, 6198.209317719169, 6369.777057803048, 913.6665117232295, 923.0492592629603, 930.8882934047957, 950.8573713942964, 959.1463597398321, 3925.175713100281, 4026.1570719219962, 4044.786564030838, 4075.694322925792, 4161.25097482456, 10859.674209773719, 11267.15496337778, 11267.887321126847, 11269.549218031187, 11293.0, 11174.273672211442, 11231.0, 11272.830907536394, 11283.887161128448, 11285.322880627024, 8457.0, 8532.189442003, 8571.485710857369, 8576.614052367659, 8608.612612432456, 5770.1344798278915, 5950.2264705587995, 5990.400959904149, 6012.068129439944, 6115.082737589397, 10012.64955726546, 10320.948395257976, 10378.0, 10420.426876521864, 10449.582016719247, 8706.303495720455, 9423.434593924387, 10540.525676344736, 10598.417087060287, 10697.411642359744, 6016.639001659914, 6697.3637504437, 6903.965480172567, 7064.364207221375, 7383.926160738324, 8520.74437766868, 8763.430377025474, 8772.254358379609, 8780.341474389574, 8813.911860881566, 6778.254392016973, 7271.4182865369585, 7502.624868756431, 7628.923710762821, 7883.526988380486, 6911.447084233349, 7018.929810701828, 7140.500164988609, 7480.401567874448, 7622.58075805836, 7125.1093613298335, 7298.927010730037, 7299.963500182677, 7318.743843965436, 7323.011393462028, 4986.351774269322, 5065.012322597058, 5067.87330316745, 5130.7178105204575, 5205.089109405914, 4554.294084416921, 5076.847694569169, 5170.948290517047, 5230.947690523199, 5242.659227150223], "value": 4655.7927458143, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [268.42556928173707, 276.79932049264283, 292.61374985019785, 308.3986226857627, 315.4668610049017, 4891.877703057426, 5424.80654256063, 5579.191017302489, 5642.774289028439, 5652.8586785330335, 4816.339581917741, 4849.187471266666, 5490.286262785832, 5552.0, 5582.190582365564, 4226.830926762926, 4232.449781528397, 4242.7242229255, 4250.362445633149, 4274.850380236692, 3639.3813051781262, 4092.7339722918064, 4155.476752179878, 4277.721948073381, 4285.185814695198, 3661.286049220403, 4116.958830411688, 4171.520275168364, 4173.269677806387, 4210.957890421102, 4163.979824942878, 4198.286291330481, 4226.471691038605, 4228.7462752234815, 4249.512670565308, 3555.6088830228914, 3638.890833275006, 3659.304732100919, 3672.173760903802, 3676.540432445944, 5074.82238121664, 5152.192055329854, 5334.199870019528, 5349.0, 5383.542398896098, 4835.105505481462, 4842.733649649268, 4846.248831431134, 4849.393825771778, 4867.610591152735, 5363.651362661453, 5406.486383793534, 5568.443155684399, 5865.237519122529, 5869.442402971711, 3838.673712734421, 3954.6158844404226, 3965.524137103537, 3982.78094704794, 4009.0155373090506, 5625.690587017753, 6214.782482613132, 6220.791618975244, 6228.346023667495, 6238.163529429414, 4039.939400908989, 4067.633912947849, 4070.5725898780793, 4070.9645177411294, 4086.387041943732, 3735.6824669903363, 3980.4029395590314, 4040.4343391925154, 4045.474088368552, 4100.487439070116, 4497.88755281114, 4524.502304746476, 4755.668412844409, 4761.952370478489, 4788.497207793132, 4714.481407045222, 4939.678920870132, 5945.524358051345, 5996.5202783777195, 6006.969965150146, 1082.53992053377, 1137.94171420578, 1256.5350820196586, 1356.8737947503548, 1380.171896861895, 691.7336825322287, 743.4275607782085, 768.6579472134846, 816.7585270388976, 839.5130824121994, 4551.044280701024, 4551.840685575989, 4579.6794224403975, 4649.465311489154, 4726.787294571753, 4386.780660966939, 4886.755662216875, 4921.606271498272, 4991.575716064175, 5134.7946082156295, 3894.532656081288, 4625.352450656911, 4642.353858300736, 4700.224462963641, 4731.243001119873, 2252.6258982020954, 2438.914637987662, 2447.8164137689387, 2687.301301661582, 2704.8241864278757, 4731.526847315241, 4884.902301953941, 5295.338082739658, 5327.706976116273, 5345.167061457434, 4386.868393948187, 4644.489106198315, 4779.5220477951925, 5142.897142057138, 5243.4232234454175, 5777.537796976316, 5845.09401042839, 5888.352281249059, 6311.842203944938, 6448.226212854487, 6221.06683997404, 6233.438990490878, 6279.874402512016, 6293.307736148929, 6310.747570097328, 5425.267588875451, 5856.648601083949, 5952.285725712769, 6011.519078473799, 6106.1146133811235, 5210.348706411699, 5576.693281869536, 6408.846407646668, 6453.548251622341, 6502.252240992347, 3984.302747019202, 4025.7987100645437, 4045.211183819127, 4048.2713111640187, 4053.61490658387, 5837.445442682938, 6015.849603759941, 6043.8186854394435, 6162.537809664383, 6165.969170154121, 5015.598752099896, 5683.9715801420725, 5891.381404952418, 5970.731317090828, 6021.578489505692, 5918.970405147947, 5926.525877929669, 6006.579539432198, 6034.7284372202475, 6039.949825338176, 5114.059415835834, 5254.42201357858, 5447.319085114361, 5735.627184233178, 5825.776586916795, 4962.404511458648, 5174.214895860922, 5916.491294719819, 5996.8800623988145, 6082.810188332285, 5840.737166827588, 5877.0605700118, 5878.3239927408895, 5905.40945905406, 5908.704564771659], "value": 4138.1357420776285, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [663.7046514301138, 728.8323685552323, 762.3215338348871, 805.6696754330726, 817.5503473089799, 15518.224088795558, 15662.060276383425, 15827.999999999985, 15837.762433563506, 15865.920670396661, 14132.940029497802, 14158.858411415882, 14179.645508862284, 14201.928990355034, 14260.786088208659, 666.410226949151, 684.349867625755, 816.6406781016334, 828.8798124271977, 836.1972506393854, 859.299670768325, 861.9655213791441, 862.6808081010035, 865.5974971638187, 865.904750477447, 915.1031988651126, 927.8283517549241, 931.501646619059, 931.5668214280358, 933.9673111441101, 866.9176428239307, 868.9522076285801, 913.7532866126109, 919.2508105893709, 919.3426699909563, 686.4542688562605, 689.5345641691838, 692.9653517324114, 693.0678237770192, 695.2977492732326, 14629.707405851823, 14661.04703194289, 14662.926685366612, 14673.559793206221, 14754.188519631416, 14336.56990290293, 14434.566962991126, 14438.422463101464, 14515.85484145166, 14556.708865822624, 11613.535458581646, 11858.3477908715, 11983.161178717493, 12034.63896083119, 12431.37843107841, 3773.3773927302236, 3802.7528210666496, 3825.1775868188197, 3875.4380614810693, 3928.135810121797, 95216.0, 114959.42520287429, 119234.0, 120680.39659801732, 125623.0, 10892.891071089347, 11207.551697931991, 11309.09527237819, 11327.207095503236, 11663.650090497298, 22713.0, 22882.65676014861, 22889.88555057214, 23076.0, 23167.957441914816, 7953.602319883983, 7995.560244186509, 8053.798655033671, 8171.63227654757, 8229.177082291842, 4334.386934021981, 4403.14138742942, 4491.910161796745, 4493.326001099796, 4517.983453722952, 3612.710983121344, 3734.458503516975, 3768.340540405418, 3768.9446954852683, 3777.490038844721, 649.9146425469478, 651.3031056769212, 668.3650531994624, 680.1701923653135, 699.7760716570649, 563.4534501533506, 660.448525481219, 661.9215662818752, 677.3463607618671, 691.7544271783545, 8721.171488708562, 9540.284478663989, 9574.617015319309, 9604.0, 9648.517574121266, 540.9567234621221, 575.9452851979055, 630.8769789890928, 641.7753786174801, 683.4498228925762, 4290.013296941721, 4320.546342634041, 4342.218400687843, 4687.976560117246, 4718.551737584924, 92610.53694731483, 103674.48162759138, 141350.0, 172732.0, 177997.0, 89979.55010225037, 92862.60706089414, 142573.0, 144843.10313793665, 151522.96954060858, 86794.56602716947, 99598.0, 116428.41785791017, 117275.41362293305, 121519.78480215262, 6595.472362211108, 8296.751097467086, 8666.613341865272, 9045.366824322235, 9063.229625481908, 51300.23049654333, 59946.0, 64142.472164031424, 68938.31061689318, 73444.0, 77253.61373193098, 85857.0, 92655.53672231865, 107632.0, 108955.45522272338, 13999.510017149758, 14270.215138167085, 14309.356078976263, 14322.641933951734, 14362.0, 14788.556343309718, 14984.250787460802, 15735.44925927587, 16173.419242109563, 16541.759368047205, 13845.376958036712, 14132.15207087578, 14260.607830809155, 14594.562163135122, 15024.924875375553, 14411.351489182802, 14537.0, 14541.927290363481, 14627.19550424737, 14820.25898705082, 13265.204087754766, 13497.122687025312, 14173.787393188904, 14223.288835557974, 14848.0, 11262.211645184758, 11287.830682539932, 11604.6518604442, 11656.766864662828, 11972.820407693718, 11626.476808543466, 11741.11941604366, 11772.646820595395, 11819.877111674377, 11926.403679815801], "value": 7930.122670774928, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1551.5, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 117.0, 118.0, 116.0, 118.0, 117.0, 116.0, 116.0, 117.0, 119.0], "value": 115.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 104.0, 142.0, 176.0, 127.0, 110.0, 112.0, 115.0, 176.0, 141.0], "value": 136.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [196.0, 198.0, 196.0, 195.0, 195.0, 190.0, 197.0, 201.0, 205.0, 196.0], "value": 196.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 60.0, 59.0, 88.0, 59.0, 61.0, 58.0, 61.0, 76.0, 59.0], "value": 66.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 71.0, 90.0, 72.0, 70.0, 67.0, 87.0, 70.0, 71.0, 87.0], "value": 76.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [130.0, 132.0, 88.0, 86.0, 87.0, 85.0, 102.0, 81.0, 84.0, 99.0], "value": 97.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 132.0, 153.0, 117.0, 150.0, 152.0, 107.0, 150.0, 152.0, 108.0], "value": 133.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 93.0, 90.0, 145.0, 143.0, 89.0, 121.0, 101.0, 76.0, 82.0], "value": 103.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [45.0, 58.0, 78.0, 52.0, 58.0, 82.0, 90.0, 91.0, 92.0, 53.0], "value": 69.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 71.0, 73.0, 80.0, 77.0, 73.0, 94.0, 104.0, 105.0, 104.0], "value": 84.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 77.0, 85.0, 73.0, 105.0, 101.0, 106.0, 84.0, 94.0, 95.0], "value": 90.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 162.0, 145.0, 135.0, 141.0, 143.0, 139.0, 143.0, 176.0, 140.0], "value": 148.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 166.0, 165.0, 163.0, 167.0, 165.0, 167.0, 166.0, 167.0], "value": 165.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 67.0, 69.0, 66.0, 69.0, 65.0, 67.0, 67.0, 68.0, 69.0], "value": 67.0, "unit": "score"}]}]} 06:06:01 INFO - Return code: 0 06:06:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:06:01 ERROR - # TBPL SUCCESS # 06:06:01 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 06:06:01 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 06:06:01 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 06:06:01 INFO - 2016-09-20 06:06:01.730 screenresolution[1667:10350] starting screenresolution argv=screenresolution get 06:06:01 INFO - 2016-09-20 06:06:01.733 screenresolution[1667:10350] Display 0: 1600x1200x32@60 06:06:01 INFO - 2016-09-20 06:06:01.739 screenresolution[1668:10353] starting screenresolution argv=screenresolution list 06:06:01 INFO - Available Modes on Display 0 06:06:01 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 06:06:01 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 06:06:01 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 06:06:01 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 06:06:01 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 06:06:01 INFO - Intel Iris: 06:06:01 INFO - Chipset Model: Intel Iris 06:06:01 INFO - Type: GPU 06:06:01 INFO - Bus: Built-In 06:06:01 INFO - VRAM (Dynamic, Max): 1536 MB 06:06:01 INFO - Vendor: Intel (0x8086) 06:06:01 INFO - Device ID: 0x0a2e 06:06:01 INFO - Revision ID: 0x0009 06:06:01 INFO - Displays: 06:06:01 INFO - Display: 06:06:01 INFO - Resolution: 1600 x 1200 @ 60 Hz 06:06:01 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 06:06:01 INFO - Display Serial Number: 1600x1200 60 06:06:01 INFO - Main Display: Yes 06:06:01 INFO - Mirror: Off 06:06:01 INFO - Online: Yes 06:06:01 INFO - Rotation: Supported 06:06:01 INFO - Return code: 0 06:06:01 INFO - Running post-action listener: _resource_record_post_action 06:06:01 INFO - [mozharness: 2016-09-20 13:06:01.975581Z] Finished run-tests step (success) 06:06:01 INFO - Running post-run listener: _resource_record_post_run 06:06:02 INFO - Total resource usage - Wall time: 1207s; CPU: 54.0%; Read bytes: 36679680; Write bytes: 665067008; Read time: 359; Write time: 1957 06:06:02 INFO - TinderboxPrint: CPU usage
54.3% 06:06:02 INFO - TinderboxPrint: I/O read bytes / time
36,679,680 / 359 06:06:02 INFO - TinderboxPrint: I/O write bytes / time
665,067,008 / 1,957 06:06:02 INFO - TinderboxPrint: CPU idle
2,204.7 (45.6%) 06:06:02 INFO - TinderboxPrint: CPU system
974.6 (20.2%) 06:06:02 INFO - TinderboxPrint: CPU user
1,650.3 (34.2%) 06:06:02 INFO - TinderboxPrint: Swap in / out
401,059,840 / 0 06:06:02 INFO - install - Wall time: 32s; CPU: 54.0%; Read bytes: 360133120; Write bytes: 356443648; Read time: 27564; Write time: 672 06:06:02 INFO - run-tests - Wall time: 1176s; CPU: 54.0%; Read bytes: 34545664; Write bytes: 297326592; Read time: 329; Write time: 1240 06:06:02 INFO - Running post-run listener: _upload_blobber_files 06:06:02 INFO - Blob upload gear active. 06:06:02 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:06:02 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 06:06:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:06:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:06:02 INFO - (blobuploader) - INFO - Open directory for files ... 06:06:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:06:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:06:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:06:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:06:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:06:03 INFO - (blobuploader) - INFO - Done attempting. 06:06:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:06:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:06:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:06:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:06:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:06:04 INFO - (blobuploader) - INFO - Done attempting. 06:06:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:06:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:06:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:06:07 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:06:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:06:07 INFO - (blobuploader) - INFO - Done attempting. 06:06:07 INFO - (blobuploader) - INFO - Iteration through files over. 06:06:07 INFO - Return code: 0 06:06:07 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:06:07 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:06:07 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3e3c63acbfbfcf35d5e1fe53b9be2526ec2d80a2b968846635b1e07cc58501004f4aaaf5380ffd43ab73aa29e91c23bd3e8c11b4d98d9fd8707f59fe5f5f1997", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/07a5294edd2ab28ca6d0a5cc9cbf73f832086bc330883d7de7d772bb1f2559e61eb4de76c4ff700b9460f873eb738925d44e5b19eb3e044200f8e453a05c3823", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4ddd27330cf39f4b1b2ee271bd1ef601f8d579db4294a008cd27a37edcf89807930d449f6a06722ff5183a7025b99d841f9e5a1812931ef4856429d9f3c4f164"} 06:06:07 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:06:07 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:06:07 INFO - Contents: 06:06:07 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3e3c63acbfbfcf35d5e1fe53b9be2526ec2d80a2b968846635b1e07cc58501004f4aaaf5380ffd43ab73aa29e91c23bd3e8c11b4d98d9fd8707f59fe5f5f1997", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/07a5294edd2ab28ca6d0a5cc9cbf73f832086bc330883d7de7d772bb1f2559e61eb4de76c4ff700b9460f873eb738925d44e5b19eb3e044200f8e453a05c3823", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4ddd27330cf39f4b1b2ee271bd1ef601f8d579db4294a008cd27a37edcf89807930d449f6a06722ff5183a7025b99d841f9e5a1812931ef4856429d9f3c4f164"} 06:06:07 INFO - Running post-run listener: copy_logs_to_upload_dir 06:06:07 INFO - Copying logs to upload dir... 06:06:07 INFO - mkdir: /builds/slave/test/build/upload/logs 06:06:07 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1268.866961 ========= master_lag: 0.07 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2016-09-20 06:06:07.206372) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-20 06:06:07.214376) ========= 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.HCvaW0txhQ/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.7d18rZP3IN/Listeners TMPDIR=/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3e3c63acbfbfcf35d5e1fe53b9be2526ec2d80a2b968846635b1e07cc58501004f4aaaf5380ffd43ab73aa29e91c23bd3e8c11b4d98d9fd8707f59fe5f5f1997", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/07a5294edd2ab28ca6d0a5cc9cbf73f832086bc330883d7de7d772bb1f2559e61eb4de76c4ff700b9460f873eb738925d44e5b19eb3e044200f8e453a05c3823", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4ddd27330cf39f4b1b2ee271bd1ef601f8d579db4294a008cd27a37edcf89807930d449f6a06722ff5183a7025b99d841f9e5a1812931ef4856429d9f3c4f164"} build_url:https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010600 build_url: 'https://queue.taskcluster.net/v1/task/dUA30X9NTyOmNgQY9g-f-w/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3e3c63acbfbfcf35d5e1fe53b9be2526ec2d80a2b968846635b1e07cc58501004f4aaaf5380ffd43ab73aa29e91c23bd3e8c11b4d98d9fd8707f59fe5f5f1997", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/07a5294edd2ab28ca6d0a5cc9cbf73f832086bc330883d7de7d772bb1f2559e61eb4de76c4ff700b9460f873eb738925d44e5b19eb3e044200f8e453a05c3823", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4ddd27330cf39f4b1b2ee271bd1ef601f8d579db4294a008cd27a37edcf89807930d449f6a06722ff5183a7025b99d841f9e5a1812931ef4856429d9f3c4f164"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-20 06:06:07.252396) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 06:06:07.252735) ========= 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.HCvaW0txhQ/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.7d18rZP3IN/Listeners TMPDIR=/var/folders/vs/05tgb2r939n1hg2_z6mc78kw00000w/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.005062 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 06:06:07.301283) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-20 06:06:07.301549) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-20 06:06:07.301815) ========= ========= Total master_lag: 0.22 =========