builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-033 starttime: 1482355927.51 results: success (0) buildid: 20161221115353 builduid: 334bffdba84d4cd8965af2712ba8ac0f revision: d43a5a11c195d12ca3a3179855a6b50a05583311 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.507130) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.507736) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.508032) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.526349) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.526622) ========= 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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-12-21 13:32:07-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 39.1M=0s 2016-12-21 13:32:07 (39.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.077072 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.617251) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.617600) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022060 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.667279) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:07.667656) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev d43a5a11c195d12ca3a3179855a6b50a05583311 --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 d43a5a11c195d12ca3a3179855a6b50a05583311 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-12-21 13:32:07,671 truncating revision to first 12 chars 2016-12-21 13:32:07,671 Setting DEBUG logging. 2016-12-21 13:32:07,671 attempt 1/10 2016-12-21 13:32:07,671 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/d43a5a11c195?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-12-21 13:32:07,968 unpacking tar archive at: mozilla-aurora-d43a5a11c195/testing/mozharness/ program finished with exit code 0 elapsedTime=0.611900 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:08.295497) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:08.295900) ========= script_repo_revision: d43a5a11c195d12ca3a3179855a6b50a05583311 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:08.296336) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:08.299701) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-21 13:32:08.310944) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-12-21 13:32:08.311369) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_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/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:32:08 INFO - MultiFileLogger online at 20161221 13:32:08 in /builds/slave/test 13:32:08 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 13:32:08 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:32:08 INFO - {'append_to_log': False, 13:32:08 INFO - 'base_work_dir': '/builds/slave/test', 13:32:08 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 13:32:08 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:32:08 INFO - 'branch': 'Mozilla-Aurora', 13:32:08 INFO - 'buildbot_json_path': 'buildprops.json', 13:32:08 INFO - 'config_files': ('talos/linux_config.py',), 13:32:08 INFO - 'default_actions': ('clobber', 13:32:08 INFO - 'read-buildbot-config', 13:32:08 INFO - 'download-and-extract', 13:32:08 INFO - 'populate-webroot', 13:32:08 INFO - 'create-virtualenv', 13:32:08 INFO - 'install', 13:32:08 INFO - 'run-tests'), 13:32:08 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:32:08 INFO - 'download_minidump_stackwalk': True, 13:32:08 INFO - 'download_symbols': 'ondemand', 13:32:08 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:32:08 INFO - 'tooltool.py': '/tools/tooltool.py', 13:32:08 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:32:08 INFO - '/tools/misc-python/virtualenv.py')}, 13:32:08 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:32:08 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:32:08 INFO - 'installer_path': 'installer.exe', 13:32:08 INFO - 'log_level': 'info', 13:32:08 INFO - 'log_name': 'talos', 13:32:08 INFO - 'log_to_console': True, 13:32:08 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:32:08 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:32:08 INFO - 'opt_config_files': (), 13:32:08 INFO - 'pip_index': False, 13:32:08 INFO - 'sps_profile': False, 13:32:08 INFO - 'sps_profile_interval': 0, 13:32:08 INFO - 'suite': 'dromaeojs-e10s', 13:32:08 INFO - 'system_bits': '32', 13:32:08 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:32:08 INFO - 'title': 'talos-linux64-ix-033', 13:32:08 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:32:08 INFO - 'use_talos_json': True, 13:32:08 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:32:08 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:32:08 INFO - 'work_dir': 'build'} 13:32:08 INFO - [mozharness: 2016-12-21 21:32:08.409114Z] Running clobber step. 13:32:08 INFO - Running pre-action listener: _resource_record_pre_action 13:32:08 INFO - Running main action method: clobber 13:32:08 INFO - rmtree: /builds/slave/test/build 13:32:08 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:32:08 INFO - Running post-action listener: _resource_record_post_action 13:32:08 INFO - [mozharness: 2016-12-21 21:32:08.864988Z] Finished clobber step (success) 13:32:08 INFO - [mozharness: 2016-12-21 21:32:08.865087Z] Running read-buildbot-config step. 13:32:08 INFO - Running pre-action listener: _resource_record_pre_action 13:32:08 INFO - Running main action method: read_buildbot_config 13:32:08 INFO - Using buildbot properties: 13:32:08 INFO - { 13:32:08 INFO - "project": "", 13:32:08 INFO - "product": "firefox", 13:32:08 INFO - "script_repo_revision": "production", 13:32:08 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 13:32:08 INFO - "repository": "", 13:32:08 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 13:32:08 INFO - "buildid": "20161221115353", 13:32:08 INFO - "pgo_build": "True", 13:32:08 INFO - "basedir": "/builds/slave/test", 13:32:08 INFO - "buildnumber": 773, 13:32:08 INFO - "slavename": "talos-linux64-ix-033", 13:32:08 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 13:32:08 INFO - "platform": "ubuntu64_hw", 13:32:08 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 13:32:08 INFO - "branch": "mozilla-aurora", 13:32:08 INFO - "repo_path": "releases/mozilla-aurora", 13:32:08 INFO - "revision": "d43a5a11c195d12ca3a3179855a6b50a05583311", 13:32:08 INFO - "stage_platform": "linux64-pgo", 13:32:08 INFO - "builduid": "334bffdba84d4cd8965af2712ba8ac0f", 13:32:08 INFO - "slavebuilddir": "test" 13:32:08 INFO - } 13:32:08 INFO - Found installer url https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2. 13:32:08 INFO - Running post-action listener: _resource_record_post_action 13:32:08 INFO - [mozharness: 2016-12-21 21:32:08.867494Z] Finished read-buildbot-config step (success) 13:32:08 INFO - [mozharness: 2016-12-21 21:32:08.867582Z] Running download-and-extract step. 13:32:08 INFO - Running pre-action listener: _resource_record_pre_action 13:32:08 INFO - Running main action method: download_and_extract 13:32:08 INFO - mkdir: /builds/slave/test/build/tests 13:32:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:08 INFO - trying https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 13:32:08 INFO - Downloading https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 13:32:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 13:32:09 INFO - Downloaded 1361 bytes. 13:32:09 INFO - Reading from file /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 13:32:09 INFO - Using the following test package requirements: 13:32:09 INFO - {u'common': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 13:32:09 INFO - u'cppunittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:32:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 13:32:09 INFO - u'gtest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:32:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.gtest.tests.zip'], 13:32:09 INFO - u'jittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:32:09 INFO - u'jsshell-linux-x86_64.zip'], 13:32:09 INFO - u'mochitest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:32:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 13:32:09 INFO - u'mozbase': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 13:32:09 INFO - u'reftest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:32:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.reftest.tests.zip'], 13:32:09 INFO - u'talos': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:32:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'], 13:32:09 INFO - u'web-platform': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:32:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 13:32:09 INFO - u'xpcshell': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:32:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 13:32:09 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 13:32:09 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 13:32:09 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:32:09 INFO - Fetch https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 13:32:10 INFO - Http code: 200 13:32:10 INFO - via: 1.1 4c2196e36fd33f377384d605b4424e95.cloudfront.net (CloudFront) 13:32:10 INFO - x-amz-cf-id: I4PfaZ2zmj5xaeboARaHfiS4h_-xSkQSz8Sozyd-56HzT-7hIO_0yw== 13:32:10 INFO - x-amz-version-id: D51RsgKGmcM418kC_Aj1caG6f86kqYiN 13:32:11 INFO - Expected file size: 21941156 13:32:11 INFO - Obtained file size: 21941156 13:32:15 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 13:32:15 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 13:32:15 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:32:15 INFO - Fetch https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 13:32:16 INFO - Http code: 200 13:32:16 INFO - via: 1.1 a1aa00de8387e7235a256b2a5b73ede8.cloudfront.net (CloudFront) 13:32:16 INFO - x-amz-cf-id: QTvPtFJluxozyI9HcCAERsgBHPDm-GY5LUqKYXsHXGvibmf2jmMbKA== 13:32:16 INFO - x-amz-version-id: D51RsgKGmcM418kC_Aj1caG6f86kqYiN 13:32:16 INFO - Expected file size: 21941156 13:32:16 INFO - Obtained file size: 21941156 13:32:20 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip 13:32:20 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 13:32:20 INFO - Fetch https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip into memory 13:32:21 INFO - Http code: 200 13:32:21 INFO - via: 1.1 41b2ee7cbe95749816a7586d9ab4629d.cloudfront.net (CloudFront) 13:32:21 INFO - x-amz-cf-id: Nngj6F3pxj_mz-eFWa6yrve4PLsTQ99UefnoiZXoQE6-2Mw_qaCG2g== 13:32:21 INFO - x-amz-version-id: fbIR_QnOg9pcei_s5QB85LY78WdIWS5r 13:32:21 INFO - Expected file size: 14409038 13:32:21 INFO - Obtained file size: 14409038 13:32:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:21 INFO - trying https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 13:32:21 INFO - Downloading https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 13:32:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 13:32:22 INFO - Downloaded 63961957 bytes. 13:32:22 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 13:32:22 INFO - mkdir: /builds/slave/test/properties 13:32:22 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:32:22 INFO - Writing to file /builds/slave/test/properties/build_url 13:32:22 INFO - Contents: 13:32:22 INFO - build_url:https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 13:32:23 INFO - Running post-action listener: _resource_record_post_action 13:32:23 INFO - Running post-action listener: set_extra_try_arguments 13:32:23 INFO - [mozharness: 2016-12-21 21:32:23.432629Z] Finished download-and-extract step (success) 13:32:23 INFO - [mozharness: 2016-12-21 21:32:23.432854Z] Running populate-webroot step. 13:32:23 INFO - Running pre-action listener: _resource_record_pre_action 13:32:23 INFO - Running main action method: populate_webroot 13:32:23 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:32:23 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:32:23 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:32:23 INFO - '--tppagecycles', 13:32:23 INFO - '7'], 13:32:23 INFO - 'tests': ['tsvgm']}}, 13:32:23 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:32:23 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 13:32:23 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:32:23 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 13:32:23 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:32:23 INFO - 'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:32:23 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:32:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:32:23 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:32:23 INFO - 'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['damp', 'tps']}, 13:32:23 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:32:23 INFO - 'tests': ['damp', 'tps']}, 13:32:23 INFO - 'g3': {'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['dromaeo_dom']}, 13:32:23 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:32:23 INFO - 'g4': {'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['basic_compositor_video']}, 13:32:23 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 13:32:23 INFO - 'other': {'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['a11yr', 13:32:23 INFO - 'ts_paint', 13:32:23 INFO - 'tpaint', 13:32:23 INFO - 'sessionrestore', 13:32:23 INFO - 'sessionrestore_no_auto_restore', 13:32:23 INFO - 'tabpaint']}, 13:32:23 INFO - 'other-e10s': {'tests': ['a11yr', 13:32:23 INFO - 'ts_paint', 13:32:23 INFO - 'tpaint', 13:32:23 INFO - 'sessionrestore', 13:32:23 INFO - 'sessionrestore_no_auto_restore', 13:32:23 INFO - 'tabpaint']}, 13:32:23 INFO - 'other-e10s_l64': {'tests': ['a11yr', 13:32:23 INFO - 'ts_paint', 13:32:23 INFO - 'tpaint', 13:32:23 INFO - 'sessionrestore', 13:32:23 INFO - 'sessionrestore_no_auto_restore', 13:32:23 INFO - 'tabpaint']}, 13:32:23 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 13:32:23 INFO - 'ts_paint', 13:32:23 INFO - 'tpaint', 13:32:23 INFO - 'sessionrestore', 13:32:23 INFO - 'sessionrestore_no_auto_restore', 13:32:23 INFO - 'tabpaint']}, 13:32:23 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['a11yr', 13:32:23 INFO - 'ts_paint', 13:32:23 INFO - 'tpaint', 13:32:23 INFO - 'sessionrestore', 13:32:23 INFO - 'sessionrestore_no_auto_restore', 13:32:23 INFO - 'tabpaint']}, 13:32:23 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['a11yr', 13:32:23 INFO - 'ts_paint', 13:32:23 INFO - 'tpaint', 13:32:23 INFO - 'sessionrestore', 13:32:23 INFO - 'sessionrestore_no_auto_restore', 13:32:23 INFO - 'tabpaint']}, 13:32:23 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['tsvgx', 13:32:23 INFO - 'tsvgr_opacity', 13:32:23 INFO - 'tart', 13:32:23 INFO - 'tscrollx', 13:32:23 INFO - 'cart']}, 13:32:23 INFO - 'svgr-e10s': {'tests': ['tsvgx', 13:32:23 INFO - 'tsvgr_opacity', 13:32:23 INFO - 'tart', 13:32:23 INFO - 'tscrollx', 13:32:23 INFO - 'cart']}, 13:32:23 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:32:23 INFO - 'talos_options': ['--disable-e10s'], 13:32:23 INFO - 'tests': ['tp5o']}, 13:32:23 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:32:23 INFO - 'tests': ['tp5o']}, 13:32:23 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:32:23 INFO - 'talos_options': ['--disable-e10s', 13:32:23 INFO - '--xperf_path', 13:32:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:32:23 INFO - 'tests': ['tp5n']}, 13:32:23 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:32:23 INFO - 'talos_options': ['--xperf_path', 13:32:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:32:23 INFO - 'tests': ['tp5n']}}, 13:32:23 INFO - 'talos.zip': {'path': '', 13:32:23 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:32:23 INFO - Running post-action listener: _resource_record_post_action 13:32:23 INFO - [mozharness: 2016-12-21 21:32:23.451425Z] Finished populate-webroot step (success) 13:32:23 INFO - [mozharness: 2016-12-21 21:32:23.451512Z] Running create-virtualenv step. 13:32:23 INFO - Running pre-action listener: _resource_record_pre_action 13:32:23 INFO - Running main action method: create_virtualenv 13:32:23 INFO - Creating virtualenv /builds/slave/test/build/venv 13:32:23 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 13:32:23 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:32:23 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:32:23 INFO - Using real prefix '/usr' 13:32:23 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:32:24 INFO - Installing distribute.............................................................................................................................................................................................done. 13:32:26 INFO - Installing pip.................done. 13:32:26 INFO - Return code: 0 13:32:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 13:32:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 13:32:26 INFO - Reading from file tmpfile_stdout 13:32:26 INFO - Output received: 13:32:26 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 13:32:26 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:32: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')]} 13:32:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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')]} 13:32:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32: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 13:32: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 13:32:26 INFO - Using env: {'DISPLAY': ':0', 13:32:26 INFO - 'HOME': '/home/cltbld', 13:32:26 INFO - 'LANG': 'en_US.UTF-8', 13:32:26 INFO - 'LANGUAGE': 'en_US:en', 13:32:26 INFO - 'LOGNAME': 'cltbld', 13:32:26 INFO - 'MAIL': '/var/mail/cltbld', 13:32:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:26 INFO - 'MOZ_NO_REMOTE': '1', 13:32:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:26 INFO - 'NO_EM_RESTART': '1', 13:32:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:26 INFO - 'PWD': '/builds/slave/test', 13:32:26 INFO - 'SHELL': '/bin/bash', 13:32:26 INFO - 'SHLVL': '1', 13:32:26 INFO - 'TERM': 'linux', 13:32:26 INFO - 'TMOUT': '86400', 13:32:26 INFO - 'USER': 'cltbld', 13:32:26 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:26 INFO - '_': '/tools/buildbot/bin/python'} 13:32:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32: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 13:32:26 INFO - Cleaning up... 13:32:26 INFO - Return code: 0 13:32:26 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 13:32: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')]} 13:32:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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')]} 13:32:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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', '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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32: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', 'psutil>=3.1.1'] in /builds/slave/test/build 13:32: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 psutil>=3.1.1 13:32:26 INFO - Using env: {'DISPLAY': ':0', 13:32:26 INFO - 'HOME': '/home/cltbld', 13:32:26 INFO - 'LANG': 'en_US.UTF-8', 13:32:26 INFO - 'LANGUAGE': 'en_US:en', 13:32:26 INFO - 'LOGNAME': 'cltbld', 13:32:26 INFO - 'MAIL': '/var/mail/cltbld', 13:32:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:26 INFO - 'MOZ_NO_REMOTE': '1', 13:32:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:26 INFO - 'NO_EM_RESTART': '1', 13:32:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:26 INFO - 'PWD': '/builds/slave/test', 13:32:26 INFO - 'SHELL': '/bin/bash', 13:32:26 INFO - 'SHLVL': '1', 13:32:26 INFO - 'TERM': 'linux', 13:32:26 INFO - 'TMOUT': '86400', 13:32:26 INFO - 'USER': 'cltbld', 13:32:26 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:26 INFO - '_': '/tools/buildbot/bin/python'} 13:32:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:26 INFO - Downloading/unpacking psutil>=3.1.1 13:32:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:32:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:32:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:32:28 INFO - Installing collected packages: psutil 13:32:28 INFO - Running setup.py install for psutil 13:32:28 INFO - building 'psutil._psutil_linux' extension 13:32:28 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 13:32:29 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 13:32:29 INFO - building 'psutil._psutil_posix' extension 13:32:29 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 13:32:29 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 13:32:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:32:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:32:29 INFO - Successfully installed psutil 13:32:29 INFO - Cleaning up... 13:32:29 INFO - Return code: 0 13:32:29 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 13:32:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:29 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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 13:32:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 13:32:29 INFO - Using env: {'DISPLAY': ':0', 13:32:29 INFO - 'HOME': '/home/cltbld', 13:32:29 INFO - 'LANG': 'en_US.UTF-8', 13:32:29 INFO - 'LANGUAGE': 'en_US:en', 13:32:29 INFO - 'LOGNAME': 'cltbld', 13:32:29 INFO - 'MAIL': '/var/mail/cltbld', 13:32:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:29 INFO - 'MOZ_NO_REMOTE': '1', 13:32:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:29 INFO - 'NO_EM_RESTART': '1', 13:32:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:29 INFO - 'PWD': '/builds/slave/test', 13:32:29 INFO - 'SHELL': '/bin/bash', 13:32:29 INFO - 'SHLVL': '1', 13:32:29 INFO - 'TERM': 'linux', 13:32:29 INFO - 'TMOUT': '86400', 13:32:29 INFO - 'USER': 'cltbld', 13:32:29 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:29 INFO - '_': '/tools/buildbot/bin/python'} 13:32:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:29 INFO - Downloading/unpacking mozsystemmonitor==0.3 13:32:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:29 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:29 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:31 INFO - Downloading mozsystemmonitor-0.3.tar.gz 13:32:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:32:31 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 13:32:31 INFO - Installing collected packages: mozsystemmonitor 13:32:31 INFO - Running setup.py install for mozsystemmonitor 13:32:31 INFO - Successfully installed mozsystemmonitor 13:32:31 INFO - Cleaning up... 13:32:31 INFO - Return code: 0 13:32:31 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 13:32: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')]} 13:32:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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')]} 13:32:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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', '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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 13:32: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 jsonschema==2.5.1 13:32:31 INFO - Using env: {'DISPLAY': ':0', 13:32:31 INFO - 'HOME': '/home/cltbld', 13:32:31 INFO - 'LANG': 'en_US.UTF-8', 13:32:31 INFO - 'LANGUAGE': 'en_US:en', 13:32:31 INFO - 'LOGNAME': 'cltbld', 13:32:31 INFO - 'MAIL': '/var/mail/cltbld', 13:32:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:31 INFO - 'MOZ_NO_REMOTE': '1', 13:32:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:31 INFO - 'NO_EM_RESTART': '1', 13:32:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:31 INFO - 'PWD': '/builds/slave/test', 13:32:31 INFO - 'SHELL': '/bin/bash', 13:32:31 INFO - 'SHLVL': '1', 13:32:31 INFO - 'TERM': 'linux', 13:32:31 INFO - 'TMOUT': '86400', 13:32:31 INFO - 'USER': 'cltbld', 13:32:31 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:31 INFO - '_': '/tools/buildbot/bin/python'} 13:32:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:31 INFO - Downloading/unpacking jsonschema==2.5.1 13:32:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:33 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:32:33 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 13:32:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:34 INFO - Downloading functools32-3.2.3-2.tar.gz 13:32:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:32:34 INFO - warning: no files found matching '*.txt' 13:32:34 INFO - no previously-included directories found matching 'build' 13:32:34 INFO - no previously-included directories found matching 'dist' 13:32:34 INFO - no previously-included directories found matching '.git*' 13:32:34 INFO - Installing collected packages: jsonschema, functools32 13:32:34 INFO - Running setup.py install for functools32 13:32:34 INFO - warning: no files found matching '*.txt' 13:32:34 INFO - no previously-included directories found matching 'build' 13:32:34 INFO - no previously-included directories found matching 'dist' 13:32:34 INFO - no previously-included directories found matching '.git*' 13:32:34 INFO - Successfully installed jsonschema functools32 13:32:34 INFO - Cleaning up... 13:32:34 INFO - Return code: 0 13:32:34 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 13:32: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')]} 13:32:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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')]} 13:32:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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', '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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32: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', 'functools32==3.2.3-2'] in /builds/slave/test/build 13:32: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 functools32==3.2.3-2 13:32:34 INFO - Using env: {'DISPLAY': ':0', 13:32:34 INFO - 'HOME': '/home/cltbld', 13:32:34 INFO - 'LANG': 'en_US.UTF-8', 13:32:34 INFO - 'LANGUAGE': 'en_US:en', 13:32:34 INFO - 'LOGNAME': 'cltbld', 13:32:34 INFO - 'MAIL': '/var/mail/cltbld', 13:32:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:34 INFO - 'MOZ_NO_REMOTE': '1', 13:32:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:34 INFO - 'NO_EM_RESTART': '1', 13:32:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:34 INFO - 'PWD': '/builds/slave/test', 13:32:34 INFO - 'SHELL': '/bin/bash', 13:32:34 INFO - 'SHLVL': '1', 13:32:34 INFO - 'TERM': 'linux', 13:32:34 INFO - 'TMOUT': '86400', 13:32:34 INFO - 'USER': 'cltbld', 13:32:34 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:34 INFO - '_': '/tools/buildbot/bin/python'} 13:32:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:34 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 13:32:34 INFO - Cleaning up... 13:32:34 INFO - Return code: 0 13:32:34 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:32: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')]} 13:32:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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')]} 13:32:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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', '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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 13:32: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 blobuploader==1.2.4 13:32:34 INFO - Using env: {'DISPLAY': ':0', 13:32:34 INFO - 'HOME': '/home/cltbld', 13:32:34 INFO - 'LANG': 'en_US.UTF-8', 13:32:34 INFO - 'LANGUAGE': 'en_US:en', 13:32:34 INFO - 'LOGNAME': 'cltbld', 13:32:34 INFO - 'MAIL': '/var/mail/cltbld', 13:32:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:34 INFO - 'MOZ_NO_REMOTE': '1', 13:32:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:34 INFO - 'NO_EM_RESTART': '1', 13:32:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:34 INFO - 'PWD': '/builds/slave/test', 13:32:34 INFO - 'SHELL': '/bin/bash', 13:32:34 INFO - 'SHLVL': '1', 13:32:34 INFO - 'TERM': 'linux', 13:32:34 INFO - 'TMOUT': '86400', 13:32:34 INFO - 'USER': 'cltbld', 13:32:34 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:34 INFO - '_': '/tools/buildbot/bin/python'} 13:32:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:34 INFO - Downloading/unpacking blobuploader==1.2.4 13:32:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:36 INFO - Downloading blobuploader-1.2.4.tar.gz 13:32:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:32:36 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:32:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:32:37 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:32:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:37 INFO - Downloading docopt-0.6.1.tar.gz 13:32:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:32:37 INFO - Installing collected packages: blobuploader, requests, docopt 13:32:37 INFO - Running setup.py install for blobuploader 13:32:37 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:32:37 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:32:37 INFO - Running setup.py install for requests 13:32:38 INFO - Running setup.py install for docopt 13:32:38 INFO - Successfully installed blobuploader requests docopt 13:32:38 INFO - Cleaning up... 13:32:38 INFO - Return code: 0 13:32:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:32: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')]} 13:32:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32: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')]} 13:32:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:38 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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 13:32:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:32:38 INFO - Using env: {'DISPLAY': ':0', 13:32:38 INFO - 'HOME': '/home/cltbld', 13:32:38 INFO - 'LANG': 'en_US.UTF-8', 13:32:38 INFO - 'LANGUAGE': 'en_US:en', 13:32:38 INFO - 'LOGNAME': 'cltbld', 13:32:38 INFO - 'MAIL': '/var/mail/cltbld', 13:32:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:38 INFO - 'MOZ_NO_REMOTE': '1', 13:32:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:38 INFO - 'NO_EM_RESTART': '1', 13:32:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:38 INFO - 'PWD': '/builds/slave/test', 13:32:38 INFO - 'SHELL': '/bin/bash', 13:32:38 INFO - 'SHLVL': '1', 13:32:38 INFO - 'TERM': 'linux', 13:32:38 INFO - 'TMOUT': '86400', 13:32:38 INFO - 'USER': 'cltbld', 13:32:38 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:38 INFO - '_': '/tools/buildbot/bin/python'} 13:32:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:32:38 INFO - Running setup.py (path:/tmp/pip-gpAVMh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:32:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:32:38 INFO - Running setup.py (path:/tmp/pip-1jX6Hw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:32:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:32:38 INFO - Running setup.py (path:/tmp/pip-5ssR52-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:32:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:32:38 INFO - Running setup.py (path:/tmp/pip-jyUBcl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:32:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:32:38 INFO - Running setup.py (path:/tmp/pip-AYOS6O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:32:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:32:38 INFO - Running setup.py (path:/tmp/pip-Ynvc9d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:32:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:32:38 INFO - Running setup.py (path:/tmp/pip-rmpbJQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:32:39 INFO - Running setup.py (path:/tmp/pip-zNUTQB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:32:39 INFO - Running setup.py (path:/tmp/pip-DyaO8D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:32:39 INFO - Running setup.py (path:/tmp/pip-3ONcdq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:32:39 INFO - Running setup.py (path:/tmp/pip-ES_T99-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:32:39 INFO - Running setup.py (path:/tmp/pip-nMr7dG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:32:39 INFO - Running setup.py (path:/tmp/pip-HHEFfy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:32:39 INFO - Running setup.py (path:/tmp/pip-d6pnzO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:32:39 INFO - Running setup.py (path:/tmp/pip-ytQllP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:32:39 INFO - Running setup.py (path:/tmp/pip-_f_3hd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:32:39 INFO - Running setup.py (path:/tmp/pip-UcQXo6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:32:39 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:32:39 INFO - Running setup.py install for manifestparser 13:32:39 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:32:39 INFO - Running setup.py install for mozcrash 13:32:39 INFO - Running setup.py install for mozdebug 13:32:40 INFO - Running setup.py install for mozdevice 13:32:40 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Running setup.py install for mozfile 13:32:40 INFO - Running setup.py install for mozhttpd 13:32:40 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Running setup.py install for mozinfo 13:32:40 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Running setup.py install for mozInstall 13:32:40 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Running setup.py install for mozleak 13:32:40 INFO - Running setup.py install for mozlog 13:32:40 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Running setup.py install for moznetwork 13:32:40 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:32:40 INFO - Running setup.py install for mozprocess 13:32:40 INFO - Running setup.py install for mozprofile 13:32:41 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:32:41 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:32:41 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:32:41 INFO - Running setup.py install for mozrunner 13:32:41 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:32:41 INFO - Running setup.py install for mozscreenshot 13:32:41 INFO - Running setup.py install for moztest 13:32:41 INFO - Running setup.py install for mozversion 13:32:41 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:32:41 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:32:41 INFO - Cleaning up... 13:32:41 INFO - Return code: 0 13:32:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:32:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:41 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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 13:32:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:32:41 INFO - Using env: {'DISPLAY': ':0', 13:32:41 INFO - 'HOME': '/home/cltbld', 13:32:41 INFO - 'LANG': 'en_US.UTF-8', 13:32:41 INFO - 'LANGUAGE': 'en_US:en', 13:32:41 INFO - 'LOGNAME': 'cltbld', 13:32:41 INFO - 'MAIL': '/var/mail/cltbld', 13:32:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:41 INFO - 'MOZ_NO_REMOTE': '1', 13:32:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:41 INFO - 'NO_EM_RESTART': '1', 13:32:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:41 INFO - 'PWD': '/builds/slave/test', 13:32:41 INFO - 'SHELL': '/bin/bash', 13:32:41 INFO - 'SHLVL': '1', 13:32:41 INFO - 'TERM': 'linux', 13:32:41 INFO - 'TMOUT': '86400', 13:32:41 INFO - 'USER': 'cltbld', 13:32:41 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:41 INFO - '_': '/tools/buildbot/bin/python'} 13:32:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:32:41 INFO - Running setup.py (path:/tmp/pip-SUf8gV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:32:41 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 13:32:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:32:41 INFO - Running setup.py (path:/tmp/pip-wV8lIW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:32:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:32:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:32:41 INFO - Running setup.py (path:/tmp/pip-oapwSW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:32:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 13:32:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:32:41 INFO - Running setup.py (path:/tmp/pip-QFGXeH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:32:42 INFO - Running setup.py (path:/tmp/pip-F_7g2n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:32:42 INFO - Running setup.py (path:/tmp/pip-iQCNWC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:32:42 INFO - Running setup.py (path:/tmp/pip-AXu4JA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:32:42 INFO - Running setup.py (path:/tmp/pip-Z2BVdD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:32:42 INFO - Running setup.py (path:/tmp/pip-NzjvO2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:32:42 INFO - Running setup.py (path:/tmp/pip-G9ZMgX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:32:42 INFO - Running setup.py (path:/tmp/pip-lcg36y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:32:42 INFO - Running setup.py (path:/tmp/pip-sglr4v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:32:42 INFO - Running setup.py (path:/tmp/pip-8H7fGU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:32:42 INFO - Running setup.py (path:/tmp/pip-3xGtk7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:32:42 INFO - Running setup.py (path:/tmp/pip-U0psbr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:32:42 INFO - Running setup.py (path:/tmp/pip-AVmsUc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:32:42 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 13:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:32:42 INFO - Running setup.py (path:/tmp/pip-85DKSg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 13:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 13:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 13:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 13:32:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:32:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:32:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:32:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:32:45 INFO - Downloading blessings-1.6.tar.gz 13:32:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:32:45 INFO - Installing collected packages: blessings 13:32:45 INFO - Running setup.py install for blessings 13:32:45 INFO - Successfully installed blessings 13:32:45 INFO - Cleaning up... 13:32:45 INFO - Return code: 0 13:32:45 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:32:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:32:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:32:45 INFO - Reading from file tmpfile_stdout 13:32:45 INFO - Current package versions: 13:32:45 INFO - argparse == 1.2.1 13:32:45 INFO - blessings == 1.6 13:32:45 INFO - blobuploader == 1.2.4 13:32:45 INFO - docopt == 0.6.1 13:32:45 INFO - functools32 == 3.2.3-2 13:32:45 INFO - jsonschema == 2.5.1 13:32:45 INFO - manifestparser == 1.1 13:32:45 INFO - mozInstall == 1.12 13:32:45 INFO - mozcrash == 1.0 13:32:45 INFO - mozdebug == 0.1 13:32:45 INFO - mozdevice == 0.48 13:32:45 INFO - mozfile == 1.2 13:32:45 INFO - mozhttpd == 0.7 13:32:45 INFO - mozinfo == 0.9 13:32:45 INFO - mozleak == 0.1 13:32:45 INFO - mozlog == 3.4 13:32:45 INFO - moznetwork == 0.27 13:32:45 INFO - mozprocess == 0.23 13:32:45 INFO - mozprofile == 0.28 13:32:45 INFO - mozrunner == 6.13 13:32:45 INFO - mozscreenshot == 0.1 13:32:45 INFO - mozsystemmonitor == 0.3 13:32:45 INFO - moztest == 0.7 13:32:45 INFO - mozversion == 1.4 13:32:45 INFO - psutil == 3.1.1 13:32:45 INFO - requests == 1.2.3 13:32:45 INFO - wsgiref == 0.1.2 13:32:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:32:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:45 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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 13:32:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:32:45 INFO - Using env: {'DISPLAY': ':0', 13:32:45 INFO - 'HOME': '/home/cltbld', 13:32:45 INFO - 'LANG': 'en_US.UTF-8', 13:32:45 INFO - 'LANGUAGE': 'en_US:en', 13:32:45 INFO - 'LOGNAME': 'cltbld', 13:32:45 INFO - 'MAIL': '/var/mail/cltbld', 13:32:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:45 INFO - 'MOZ_NO_REMOTE': '1', 13:32:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:45 INFO - 'NO_EM_RESTART': '1', 13:32:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:45 INFO - 'PWD': '/builds/slave/test', 13:32:45 INFO - 'SHELL': '/bin/bash', 13:32:45 INFO - 'SHLVL': '1', 13:32:45 INFO - 'TERM': 'linux', 13:32:45 INFO - 'TMOUT': '86400', 13:32:45 INFO - 'USER': 'cltbld', 13:32:45 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:45 INFO - '_': '/tools/buildbot/bin/python'} 13:32:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 13:32:45 INFO - Cleaning up... 13:32:45 INFO - Return code: 0 13:32:45 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:32:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:32:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:32:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:32:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:32:45 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 0x7ff845dbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bdca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 13:32:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 13:32:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 13:32:45 INFO - Using env: {'DISPLAY': ':0', 13:32:45 INFO - 'HOME': '/home/cltbld', 13:32:45 INFO - 'LANG': 'en_US.UTF-8', 13:32:45 INFO - 'LANGUAGE': 'en_US:en', 13:32:45 INFO - 'LOGNAME': 'cltbld', 13:32:45 INFO - 'MAIL': '/var/mail/cltbld', 13:32:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:32:45 INFO - 'MOZ_NO_REMOTE': '1', 13:32:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:32:45 INFO - 'NO_EM_RESTART': '1', 13:32:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:32:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:32:45 INFO - 'PWD': '/builds/slave/test', 13:32:45 INFO - 'SHELL': '/bin/bash', 13:32:45 INFO - 'SHLVL': '1', 13:32:45 INFO - 'TERM': 'linux', 13:32:45 INFO - 'TMOUT': '86400', 13:32:45 INFO - 'USER': 'cltbld', 13:32:45 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:32:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:32:45 INFO - '_': '/tools/buildbot/bin/python'} 13:32:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:32:45 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 13:32:45 INFO - Cleaning up... 13:32:45 INFO - Return code: 0 13:32:45 INFO - Running post-action listener: _resource_record_post_action 13:32:45 INFO - Running post-action listener: _start_resource_monitoring 13:32:46 INFO - Starting resource monitoring. 13:32:46 INFO - [mozharness: 2016-12-21 21:32:46.004388Z] Finished create-virtualenv step (success) 13:32:46 INFO - [mozharness: 2016-12-21 21:32:46.004842Z] Running install step. 13:32:46 INFO - Running pre-action listener: _resource_record_pre_action 13:32:46 INFO - Running main action method: install 13:32:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:32:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:32:46 INFO - Reading from file tmpfile_stdout 13:32:46 INFO - Detecting whether we're running mozinstall >=1.0... 13:32:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:32:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:32:46 INFO - Reading from file tmpfile_stdout 13:32:46 INFO - Output received: 13:32:46 INFO - Usage: mozinstall [options] installer 13:32:46 INFO - Options: 13:32:46 INFO - -h, --help show this help message and exit 13:32:46 INFO - -d DEST, --destination=DEST 13:32:46 INFO - Directory to install application into. [default: 13:32:46 INFO - "/builds/slave/test"] 13:32:46 INFO - --app=APP Application being installed. [default: firefox] 13:32:46 INFO - mkdir: /builds/slave/test/build/application 13:32:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 13:32:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 13:33:02 INFO - Reading from file tmpfile_stdout 13:33:02 INFO - Output received: 13:33:02 INFO - /builds/slave/test/build/application/firefox/firefox 13:33:02 INFO - Running post-action listener: _resource_record_post_action 13:33:02 INFO - [mozharness: 2016-12-21 21:33:02.216264Z] Finished install step (success) 13:33:02 INFO - [mozharness: 2016-12-21 21:33:02.216506Z] Running run-tests step. 13:33:02 INFO - Running pre-action listener: _resource_record_pre_action 13:33:02 INFO - Running main action method: run_tests 13:33:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:33:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:33:02 INFO - Python 2.7.3 13:33:02 INFO - Return code: 0 13:33:02 INFO - grabbing minidump binary from tooltool 13:33:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:33:02 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/linux64/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 0x27baf60>, '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 0x27bbd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27bc1d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:33:02 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/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 13:33:02 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/linux64/releng.manifest -o -c /builds/tooltool_cache 13:33:02 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/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 13:33:02 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:33:02 INFO - Return code: 0 13:33:02 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:33:02 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:33:02 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:33:02 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:33:02 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:33:02 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/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-033', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 13:33:02 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/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-033 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 13:33:02 INFO - Using env: {'DISPLAY': ':0', 13:33:02 INFO - 'HOME': '/home/cltbld', 13:33:02 INFO - 'LANG': 'en_US.UTF-8', 13:33:02 INFO - 'LANGUAGE': 'en_US:en', 13:33:02 INFO - 'LOGNAME': 'cltbld', 13:33:02 INFO - 'MAIL': '/var/mail/cltbld', 13:33:02 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:33:02 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:33:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:33:02 INFO - 'MOZ_NO_REMOTE': '1', 13:33:02 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:33:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:33:02 INFO - 'NO_EM_RESTART': '1', 13:33:02 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:33:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:33:02 INFO - 'PWD': '/builds/slave/test', 13:33:02 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:33:02 INFO - 'SHELL': '/bin/bash', 13:33:02 INFO - 'SHLVL': '1', 13:33:02 INFO - 'TERM': 'linux', 13:33:02 INFO - 'TMOUT': '86400', 13:33:02 INFO - 'USER': 'cltbld', 13:33:02 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593', 13:33:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:33:02 INFO - '_': '/tools/buildbot/bin/python'} 13:33:02 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/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-033', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 13:33:02 INFO - mozversion application_buildid: 20161221115353 13:33:02 INFO - mozversion application_changeset: d43a5a11c195d12ca3a3179855a6b50a05583311 13:33:02 INFO - mozversion application_display_name: FirefoxDeveloperEdition 13:33:02 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:33:02 INFO - mozversion application_name: Firefox 13:33:02 INFO - mozversion application_remotingname: firefox-dev 13:33:02 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 13:33:02 INFO - mozversion application_vendor: Mozilla 13:33:02 INFO - mozversion application_version: 52.0a2 13:33:02 INFO - mozversion platform_buildid: 20161221115353 13:33:02 INFO - mozversion platform_changeset: d43a5a11c195d12ca3a3179855a6b50a05583311 13:33:02 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 13:33:02 INFO - mozversion platform_version: 52.0a2 13:33:02 INFO - using testdate: 1482355982 13:33:02 INFO - actual date: 1482355982 13:33:02 INFO - starting webserver on 'localhost:49746' 13:33:02 INFO - SUITE-START | Running 2 tests 13:33:02 INFO - TEST-START | dromaeo_css 13:33:02 INFO - operating with platform_type : linux_ 13:33:02 INFO - Initialising browser for dromaeo_css test... 13:33:02 INFO - TEST-INFO | started process 18435 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3soKgx/profile http://localhost:49746/getInfo.html) 13:33:07 INFO - PROCESS | 18435 | __metrics Screen width/height:1600/1200 13:33:07 INFO - PROCESS | 18435 | colorDepth:24 13:33:07 INFO - PROCESS | 18435 | Browser inner width/height: 1024/697 13:33:07 INFO - PROCESS | 18435 | __metrics 13:33:08 ERROR - PROCESS | 18435 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3175: TypeError: this.tabs is undefined 13:33:09 INFO - TEST-INFO | 18435: exit 0 13:33:09 INFO - Browser initialized. 13:33:09 INFO - Running cycle 1/1 for dromaeo_css test... 13:33:09 INFO - TEST-INFO | started process 18567 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3soKgx/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:33:20 INFO - PROCESS | 18567 | RSS: Main: 151855104 13:33:20 INFO - PROCESS | 18567 | 13:34:10 INFO - PROCESS | 18567 | 1482356050573 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 13:36:21 INFO - PROCESS | 18567 | Cycle 1(1): loaded http://localhost:49746/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49746/tests/dromaeo/cssquery-ext.html) 13:36:22 INFO - PROCESS | 18567 | RSS: Main: 156053504 13:36:22 INFO - PROCESS | 18567 | 13:39:24 INFO - PROCESS | 18567 | Cycle 1(1): loaded http://localhost:49746/tests/dromaeo/cssquery-ext.html (next: http://localhost:49746/tests/dromaeo/cssquery-jquery.html) 13:39:25 INFO - PROCESS | 18567 | RSS: Main: 153145344 13:39:25 INFO - PROCESS | 18567 | 13:42:27 INFO - PROCESS | 18567 | Cycle 1(1): loaded http://localhost:49746/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49746/tests/dromaeo/cssquery-mootools.html) 13:42:28 INFO - PROCESS | 18567 | RSS: Main: 153591808 13:42:28 INFO - PROCESS | 18567 | 13:45:29 INFO - PROCESS | 18567 | Cycle 1(1): loaded http://localhost:49746/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49746/tests/dromaeo/cssquery-prototype.html) 13:45:30 INFO - PROCESS | 18567 | RSS: Main: 151437312 13:45:30 INFO - PROCESS | 18567 | 13:48:33 INFO - PROCESS | 18567 | Cycle 1(1): loaded http://localhost:49746/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49746/tests/dromaeo/cssquery-yui.html) 13:48:33 INFO - PROCESS | 18567 | RSS: Main: 154828800 13:48:33 INFO - PROCESS | 18567 | 13:51:35 INFO - PROCESS | 18567 | Cycle 1(1): loaded http://localhost:49746/tests/dromaeo/cssquery-yui.html (next: http://localhost:49746/tests/dromaeo/cssquery-dojo.html) 13:51:36 INFO - PROCESS | 18567 | RSS: Main: 155045888 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - PROCESS | 18567 | __start_tp_report 13:51:36 INFO - PROCESS | 18567 | _x_x_mozilla_page_load 13:51:36 INFO - PROCESS | 18567 | _x_x_mozilla_page_load_details 13:51:36 INFO - PROCESS | 18567 | |i|pagename|runs| 13:51:36 INFO - PROCESS | 18567 | |0;dojo.html;3328.3509715605455;3348.6986171244585;3362.5796775403082;3366.2425954160303;3371.359441706076;5778.6243894146855;5807.332156801964;5840.824775256739;5849.09339052447;5874.295084589855;5779.913301300484;5851.473367396933;5862.0913758367415;5867.794627188049;5868.2664666916635;5227.73861306935;5286.497782710637;5291.31212942317;5304.549113325372;5319.494648008433;5339.839804805862;5341.813036543722;5342.492463216007;5356.839294821161;5370.650907690988;5129;5141.0489059523925;5306.814261500848;5339.466053394668;5339.733013349336;5161.27742116104;5174.990876779029;5243.2659427680155;5289.576833853283;5335.999999999961;5202.375714914235;5206.661566998133;5246.580273578143;5263.6841789492755;5295.973520132413;5600.635958662674;5731.484166425;5758.481736643722;5855.121731740231;5855.473007429309;6048.304444988838;6077.848053798691;6078.696065196723;6088.726007329681;6136.325004249529;6129.969350153221;6154.44609985099;6157.661328626924;6211.25464944205;6216.316205217422;5784.248047753765;5804.1293805929445;5806.883862322772;5822.650640961556;5854.531637468992;6289.622622642564;6292.244930608356;6334;6346.555741098079;6398;6111.786087486917;6136.8772624547255;6138.662373569497;6141.385861413823;6208.751649934043;5984.3417224105315;6027.126066720301;6216.937830621636;6303.558750887394;6307.5584709070845;6069.15031895535;6076.665783381868;6121.209103132385;6203.131561581382;6220.253569571681;6138.14066030756;6156.230471191101;6181.660008699565;6191.4118158774845;6203.31763506014;4621.30680397943;4755.9286610700865;4759.833405830779;4765.475797662254;4785.617150627942;4127.236461254677;4145.91708165841;4156.210320039183;4174.123434078817;4246.639035682002;5833.300003999547;5886.852828679232;5890.67601281925;5896.233489646319;5901.616394934315;6182;6192.566520343533;6192.876142477216;6210.472109870621;6221.191245138103;5697.316322041382;5782.277215348082;5820.330661973842;5894.705264736746;5929.05135178378;5334.093204155303;5388.649737767033;5409.756560954766;5432.266644003088;5442.374126975369;6401.1678481798;6470.9029364559565;6472.3204063573585;6479.5788273763;6515.902261465987;6040.184575082308;6121.112438696453;6134.681512609229;6292.685365731603;6295.748170073329;6365.649889256136;6491.188601424822;6492.31830657793;6504.414602685781;6513.4463570595135;6113.052476866093;6119.663418511846;6139.4781443577795;6155.1075094112;6155.199824022849;6029.698515074317;6077.270727512727;6218.689065546795;6267.905981410191;6283.528735344776;6056.242969628796;6087.330393656605;6093.969530152321;6141.263048434216;6188.752449902134;6121.969859688293;6124.142620033288;6126.334466363025;6127.097902969389;6133.977404287646;5761.049426844524;5981.401859813984;6057.061155520902;6089.056196289582;6105.419985101408;5948.37542058095;6057.909131363122;6074;6100.8779824404155;6142.621558143092;5935.881282374242;5961.403859614177;5968.522518198447;5990.071538911476;6000.579959402975 13:51:36 INFO - PROCESS | 18567 | |1;ext.html;584.2813339592301;610.6885488400916;634.479726624168;656.501059195012;660.8843452395829;44192.77903610482;45302.54697453028;45389.319160212624;48830.75584622081;49099.263511047364;45382.773086134606;45446.318305225446;45901.31148032782;45937.31094033592;45981;8833.602487888029;8962.283017358628;8963.193312601865;8972.910270897306;8982.416142950688;8827.293816494697;8840.911590884074;8852.291816654651;8933.46399216046;8962.775930601721;8938.821223575525;8944.8658270126;8969.282457403391;8993.370464067519;9025.458472491639;8917.821643567126;8938.106189381075;8943.776405589848;8945.329100317469;8959.41763785352;8848.911510884873;8872.201501864798;8901.554922253927;8912.108789121101;8929.107089291085;43428.78285608552;43543;43662.12675746499;43714;43742.12515749699;3572.821358932069;3718.9070273243115;3725.3480640887738;3768.3970564709516;4121.670266378683;32249.1937701557;32251;32509.6749032509;32538.67461325404;32696.673033269602;4516.887077823048;4540.523245059288;4557.248054071074;4569.246074397721;4645.721256724573;372144;373842;376315;377886;379692;59744;60136.097958530656;60280.39719602748;60482;60551;67885.66057169682;68143.31856681469;68424.3157568418;68437.65781171063;68838.65580672065;18364.632707346045;18408.447746567625;18560.443186704422;18578.535536611424;18723.063846807607;14161.85838141626;14336.928315358356;14343.928280358532;14367;14420.567382978528;19419.611607767765;20365.287214947406;20601.278955236496;20702.792972070085;20850.270240541508;7491.775246742606;7494.288042635941;7498.3626391756225;7673.61631918413;7929.986605090145;984.1142971325864;1071.9142468602492;1106.7399161197113;1132.1508868348737;1155.2086820527797;33248.501272480935;33426.16434589106;33625.66374336274;33929.83035084809;34072.65927340695;1174.1741442670616;1183.3077649574923;1198.568515334479;1198.6823491774687;1201.1711918776016;16466.917665411594;17288;17368.218430170673;17593.7360939586;17656.646867062587;505818;505910;506737;508452;509044;59781;60222.39777602168;60279.69860150671;60287.39712602906;60378;1446.9855301447271;1457.8031965684709;1460.715160543705;1492.6492274315526;1494.6114010357385;31783.523247151774;32030.35939281248;32981.340373192885;33016.67933282738;33278;53978;54504;54715;54783;54798.452015479335;458404;459720;461167;461916;463259;29970.850145749133;30091;30366.240843979078;30381.544276836306;30605.846970765004;48264;48642.5135748638;48679;49019;49990.500094998584;41186.38220426636;41272.380914285706;41730;41827.7908610455;42551.3617295747;41991.580084198766;42025.57974420339;42319.3652095225;42837.14325713531;43117.13765724731;40809.79595102005;40883.79558102191;43272.350914735674;44202;46870;41539.7923010383;43134;44975.550244497135;45532.77233613811;46535.53464465312;34084.31831363408;35833.28333433369;35986.82006590055;36033.639663603026;36208.27583448369 13:51:36 INFO - PROCESS | 18567 | |2;jquery.html;396.48457005892334;401.2977289742948;425.45541706615523;425.8956555643868;433.9631131353835;19577.412677619675;19707.605847883035;20129.094190761414;20217.191312347524;20297.59404811903;16367.181640917966;17461.82538174621;19640.21439142436;20187.192512299527;20372;5506.752196151163;5823.446772556622;5840.299164100314;5877.147813567051;5920.851978700523;5659.66042037477;5747.856303592402;5757.395473475288;5823.359430462667;5843.8539036524;5808.912866307009;5821.6507009579345;5825.475707186352;5835.153902684108;5855.648661080328;5635.8591035224445;5785.71071446426;5796.188533605298;5803.477687008169;5854.590178687494;5238.161894096965;5240.161574148156;5248.8425347239645;5252.317198764136;5265.104932161542;23628.527429451486;23666.64500032501;23765.643515347285;23770.168044118374;24194.758052419427;2679.1828492309837;3138.8430578470984;3143.76421768366;3208.406444807718;3210.0209436121972;12655.683607909783;14520.564383068524;15087.321070551852;15184.392624295015;15634.609134771608;1857.619188066443;1999.430162403708;2007.5081605006867;2013.3456626596414;2064.917403303866;86788;87466;89554;90432;91589.54205228998;10676.839847402296;10803.783924321628;11135.777284454427;11988.400579970967;12152.75694486123;17328.82671173272;17330.566735831453;17394.391196308068;17396.130193490273;17428.302867885395;9056.954715226382;9084.137006984325;9131.315151363675;9181.219596334253;9213.861792073125;8724.083971183061;8744.650213991496;8810.911890881138;9021.729348119567;9027.14242146995;5177.094008548489;5182.792688292501;5210.713410762444;5268.604854635841;5279.9208011879855;2037.5619241863071;2128.8616239944354;2154.332157031294;2155.4180371299976;2175.4561359660083;917.4449458077901;1014.7463134216446;1070.7751372211924;1096.9780604387868;1128.8306753986967;19872.70190947137;20283.391498255078;20407.081681324376;20487.69268460974;20837.37487875366;1005.3666190300064;1030.6907927621683;1053.0838170791308;1090.650991682654;1100.7193165742685;10611.416372099455;11314.264572802906;11460.19778615489;11511;11528.423578821026;438096;446485;451553;464288;476643;58522.41477585255;61285.693571531854;94276.52861735647;97333.51333243288;97536.51231743796;1072.383379556758;1097.5664612478186;1143.3254379915888;1181.9586314478952;1181.9645410637695;18055.458336249932;18205.18076686579;18541.44375668732;18582.721259180853;18753.1561079749;38726;43640.34539481847;43743.56256437395;44023.55976440194;44632.33051504165;62842.05736914041;62879.6856015717;63220.68389658022;63654.68172659107;63875.68062159659;8654.264387527131;8796.340274479568;8833.514156721441;8855.467855756482;8972.775680608038;11314;13543.525976590772;13624.795628065389;13678.521251756141;13788.103773254707;12011.519539218683;12055;12088.395580220778;12108.455119519818;12200.877991219973;11595.304281743123;11620.767584648429;11826.113041522092;11948;12129.636110916686;12141.332226727614;12234.694132646755;12263.632091037283;12400.13199076056;12527.93736031314;8632.179942905414;8775.517346546001;8899;8908.198262156437;9138.360314777901;11234.55061797519;11698.415079245833;11749.76500470003;11851.466683999413;12424.813627795771 13:51:36 INFO - PROCESS | 18567 | |3;mootools.html;1515.0758037597063;1542.1209910351097;1712.1097029544637;1778.0309731196496;1799.7300404939258;7972.840543189132;8212.54830984297;8497.19276668717;9130.863037054442;9137.543122843856;8601.870971935426;8814.82370352594;8834.646614135443;9047.009657875273;9119.863202051958;2495.8003359731224;2520.8865601047996;2537.479816637594;2556.0670355320267;2556.0925871315694;2326.534693061386;2506.962395564068;2548.8215824892263;2558.322044658167;2564.1410127607182;2472.1223965492263;2491.5141547398266;2500.499900020003;2511.610700341441;2520.281719709883;2451.276873322383;2473.109680515013;2495.2264797912703;2508.79929605632;2512.1584269269633;2434.3670645632264;2454.5459090068393;2465.3220364399754;2480.045182604692;2514.3462699698025;9103.499307538083;9116.589753461043;9118.270538356915;9141.954290228572;9166.495842728647;5488.53347465466;5563.332400111972;5584.050711379075;5623.915641265385;5639.830805075813;3556.8577256909693;3594.712423006153;3690.5940346562124;3791.1659434924272;3841.116543195081;1204.4158583087196;1226.1049433913204;1229.5081967213187;1273.8216649669055;1275.9553415630407;12346.580143283547;12461.563845265462;12471.688207794787;12483.687907802287;12531.686707832287;4959.801607935714;5037.647364684511;5058.570021548136;5069.214271787879;5164.173732202829;10459.633912813168;10535.367877927349;10596.576136954589;10644.148468122532;10669.35983840972;5698.401667824902;5702.116171993348;5711.885762284731;5745.597808153473;5747.626404283708;5049.6212784041345;5263.6315457918345;5283.6037297202865;5288.92066619001;5353.544948679406;3965.464662270614;4057.2494088593703;4059.127287633173;4129.442525259112;4145.585441455831;1273.420593629896;1288.1112032697408;1301.3363184775644;1307.130758045908;1316.5063101336998;911.7720569857536;968.7820240445843;988.8714467119372;989.5794287427815;998.4458625462793;5846.970765146147;5975.462208401264;6079.05774604937;6117.602355846856;6149;490.4335492506161;498.5263999200774;506.70357840663627;511.52683767515646;515.4458956621646;4017.397390391465;4139.151473947833;4158.126793373365;4170.666346692257;4178.35235538492;10877.891221087846;11249.71875703114;11283.717907052389;11319.717007074889;11341.546338146547;10961.83557246642;11051.336919784839;11087.72280692989;11124.721881953015;11159.218854680257;8318.66725330992;8337.666493340319;8600.397972142015;8622.353323500762;8656.52389118592;5768.365479797303;5852.209951656642;5948.405159484017;5950.107483877453;5969.9701501493955;9577.760555986157;10161.136303413998;10227.693169204937;10280.588776448858;10401.375917444977;10214.182865370603;10364.067233948981;10372.429516376369;10420.374777513374;10464.63373781914;7312.926870731225;7856.84286314282;7914.920850791418;7926.920730792618;8110.594470276581;8860.158284962918;8861.867071993796;8893.421927574687;8897.199252067086;8903.421277616933;7548.886766698613;7624.237576242332;7718.266764657348;7855;7912.36701063925;7709.3447057000785;7803.648835802289;7814.4529882907655;7822.256885595859;7942.761717148494;7235.710571577078;7277.563346199245;7351.595662238628;7363.77908662741;7455.925440745523;5070.974645126751;5175.948240517697;5296.285001524899;5411.215373770702;5481.260029895913;5084.161113416245;5157.922631160461;5203.089459344524;5337.919931201112;5350.866228344167 13:51:36 INFO - PROCESS | 18567 | |4;prototype.html;352.858856457417;357.626280536839;363.3586719440187;364.27145708582833;364.35691005375514;5641.912492377821;5701.486866182043;5708.289611752352;5720.313562372521;5723.799667011655;5533.6403133796275;5642.746076426561;5647.576431767624;5663.546916246701;5677.460641239086;4421.314696222091;4446.7776611169475;4459.9331010034875;4461.152381047598;4472.172648060103;4450.821967121311;4460.598546130847;4469.955300446986;4471.977640111795;4475.418195634563;4437.800298986554;4443.289073748201;4443.4445694288215;4451.955480445203;4480.126375356806;4342.457192850894;4405.889852753675;4443.51184320307;4451.688381813258;4453.354263631755;3948.1511475033008;3957.445957565943;3966.682665386762;3967.7420967637013;3981.900452488682;5541.972290138524;5544.584156188302;5564.33228012637;5571.916421253684;5573.136163894603;4976.950230497685;5079.492050794928;5114.667546609496;5117.283580298761;5129.769160387791;5846.9707651461895;5905;5912.201852749867;5917.674527900964;5932.495737862287;4317.639943417845;4348.369486424483;4370.2570563004365;4383.211022016036;4390.100029493946;5915.526757859361;5921.348651648315;6097.969510152421;6138.907916381258;6139.048447490691;4311.353297005474;4313.245182093121;4341.131773645284;4341.565843415633;4365.694401391872;4415.51429342772;4417.823287068545;4419.779011049434;4436.933445998313;4438.844640437569;4920;5003.524665156804;5078.949210507848;5079.764903442473;5110.71891045996;5918.260217472816;5920.822375328747;5938.732757025944;5962.25471816023;5965.55258355625;1478.1205182916149;1481.126135580013;1482.629342664334;1493.3573069623544;1497.9176145311894;966.8791401074866;998.1964518562481;1020.3469779341227;1027.9383237005804;1032.2516175772505;5567.832965011056;5577.860553486195;5596.916046259309;5598.972005139948;5599.720013999284;5895.793647222326;5897.439743224387;5900;5911.379305172981;5912.3496415394275;5493.423190565013;5559.249501317351;5632.690202038927;5657.179708942181;5672.4894759471845;3056.8930087446834;3105.82917939511;3122.2506598416217;3123;3133.3576616793503;5819;6048.546359023003;6068.664893723374;6072.271327440735;6077.696115194222;5888.528917686661;5892.234009578728;5892.381299963442;5930.318013428425;5940.61386009908;6013.075815738922;6034.762873610899;6040.335563088057;6049.879002419927;6102.816915492543;5698.914516282176;5857.238558987305;6048.667323297261;6160.537959652955;6184.165137706532;6076.787312444043;6080;6085.178500902499;6087.543434242361;6099.817005489843;5979.402059793986;6096.329403765493;6284.748610055546;6333.20834895638;6417.93582064192;4312.180685669713;4360.607545320936;4366.650667946493;4373.628241599499;4386.429764130643;5903.7048147593305;6166.229221347332;6168.876622467616;6184.783532576338;6186.288576813724;6020.742221666875;6022.09668549721;6046.365131661112;6049.848753781191;6073.271207455134;6000.189974353407;6008.098785182257;6011.27864656244;6031.36670649593;6037.78867739627;5648.63283886546;5937.198478205387;5965.552583556164;5970.910436343545;5973.880522389615;5975.940240597538;6000.759969601167;6033.698315084316;6049.78825741097;6052.878942421215;5560.9712203240915;5785.971070144622;5832.912506312324;5833.183354330482;5838.678872661874 13:51:36 INFO - PROCESS | 18567 | |5;yui.html;780.1730166024015;801.4510060608484;835.1398059998202;857.3698331726184;899.4783025845011;14763.778543321845;15420.228988550569;15565.29956151973;15614.687706245883;15678.921605391986;12859.48562057519;12904.677383065427;14733.189674567895;15475.613109672264;15491.225438728075;830.5265998380926;846.7967687754956;849.7068511363569;849.7280870121564;850.1201256699318;866.2290561400358;870.2081106193365;870.4907629037021;870.6560908441162;870.7692461497708;901.0944001278706;907.9909200907972;912.7991841794827;914.7392992996997;915.2403505090758;903.1375036839802;905.3888625177979;910.1035480052143;910.6721580231111;912.9726108216731;665.3213722003578;666.2404858461358;666.5434177588368;671.6675245753335;671.8857794174953;14724.19016954067;14803;14804.40782368704;14857.777133343008;14867.405303787944;14507.782383264259;14526.70946581073;14726.558203253919;14775;15115.546533604009;12079.93960030203;12135.696607584881;12144.149909506337;12308.630741077692;12444.128910976235;3866.052817059838;3902.043999220181;3902.551206611248;3951.2097580483733;3973.3443981742976;67716.6614166931;69001;69854.30145698579;69883;71730.64134679345;11222.326660400402;11331.206815522833;11527.76944461106;11528.250663706833;11560.826587601192;20812.58374832495;20968;21008.89495552543;21038.89480552618;21374.358769236947;7979.640916158787;7981.521108733495;8108.8378232435025;8248.298894593907;8355.206255405727;4807;4812.085703716282;4874.171390863562;4891.706497610084;4955.132851750929;3434.364642541138;3486.1104184329856;3501.9824900875333;3548.361294966879;3561.7684850484634;639.7952655150307;644.4876323322969;648.0959062108333;648.6237981970446;682.7712716240115;700.1947760075954;741.8924255982852;754.8528037032836;773.9860782374994;783.9372850171973;9002.909970900208;9395;9396.765080872896;9484;9587.520623968774;678.8913773796169;752.2853289375006;774.4617490843922;789.0176729971223;789.3369569561481;4623.884402889955;4684.929726054112;4701.529847015271;4782.139214941274;4804.807807687724;94023;94104.32648663675;95554.52222738841;95639.52180239193;97031;63693.36306636967;75560.24439755532;76088.61955690297;81129.59435202905;83453.58273208595;44906.3264051033;49261;64618.35381646217;66733.666331669;69127.30872691209;9532.380395274286;9781.60873565078;9973.351732137387;10001.699949001542;10063.798724025624;46870.29694554516;46992.29511557261;47729;47734.76132619315;48219.5178048215;60912.69543652253;61250.69374653098;65315.67342163449;65943.67028164829;68860.6556967212;12413.44139513706;12754.872451275369;13173.143745656886;13206.801897971345;13259.734805304033;14940.551783446514;15161;15238.847611524187;15289.847101528841;15472.845271547141;13623.591292261248;14219.786703199667;14426.567202983928;14585;14649.26753662334;13804.102733322303;13869.237191954137;14456.638584035063;14580.125192488485;14930.402783888523;14254.714905702036;14458.204798736171;14463.927680361952;14474.565763027125;14635.92682036583;11408;11602.76794464123;12183.451744671334;12197.451114700038;12529.248245104958;11741.55656369404;11753.647390578297;11874.703132421759;11895.762084758084;12259.080568957186 13:51:36 INFO - PROCESS | 18567 | __end_tp_report 13:51:36 INFO - PROCESS | 18567 | __start_cc_report 13:51:36 INFO - PROCESS | 18567 | _x_x_mozilla_cycle_collect,298 13:51:36 INFO - PROCESS | 18567 | __end_cc_report 13:51:36 INFO - PROCESS | 18567 | __startTimestamp1482357096143__endTimestamp 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - PROCESS | 18567 | ------- Summary: start ------- 13:51:36 INFO - PROCESS | 18567 | Number of tests: 6 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - PROCESS | 18567 | [#0] dojo.html Cycles:165 Average:5761.15 Median:5990.07 stddev:658.11 (11.0%) stddev-sans-first:631.85 13:51:36 INFO - PROCESS | 18567 | Values: 3328.4 3348.7 3362.6 3366.2 3371.4 5778.6 5807.3 5840.8 5849.1 5874.3 5779.9 5851.5 5862.1 5867.8 5868.3 5227.7 5286.5 5291.3 5304.5 5319.5 5339.8 5341.8 5342.5 5356.8 5370.7 5129.0 5141.0 5306.8 5339.5 5339.7 5161.3 5175.0 5243.3 5289.6 5336.0 5202.4 5206.7 5246.6 5263.7 5296.0 5600.6 5731.5 5758.5 5855.1 5855.5 6048.3 6077.8 6078.7 6088.7 6136.3 6130.0 6154.4 6157.7 6211.3 6216.3 5784.2 5804.1 5806.9 5822.7 5854.5 6289.6 6292.2 6334.0 6346.6 6398.0 6111.8 6136.9 6138.7 6141.4 6208.8 5984.3 6027.1 6216.9 6303.6 6307.6 6069.2 6076.7 6121.2 6203.1 6220.3 6138.1 6156.2 6181.7 6191.4 6203.3 4621.3 4755.9 4759.8 4765.5 4785.6 4127.2 4145.9 4156.2 4174.1 4246.6 5833.3 5886.9 5890.7 5896.2 5901.6 6182.0 6192.6 6192.9 6210.5 6221.2 5697.3 5782.3 5820.3 5894.7 5929.1 5334.1 5388.6 5409.8 5432.3 5442.4 6401.2 6470.9 6472.3 6479.6 6515.9 6040.2 6121.1 6134.7 6292.7 6295.7 6365.6 6491.2 6492.3 6504.4 6513.4 6113.1 6119.7 6139.5 6155.1 6155.2 6029.7 6077.3 6218.7 6267.9 6283.5 6056.2 6087.3 6094.0 6141.3 6188.8 6122.0 6124.1 6126.3 6127.1 6134.0 5761.0 5981.4 6057.1 6089.1 6105.4 5948.4 6057.9 6074.0 6100.9 6142.6 5935.9 5961.4 5968.5 5990.1 6000.6 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - PROCESS | 18567 | [#1] ext.html Cycles:180 Average:62335.55 Median:44588.78 stddev:119261.13 (267.5%) stddev-sans-first:119505.56 13:51:36 INFO - PROCESS | 18567 | Values: 584.3 610.7 634.5 656.5 660.9 44192.8 45302.5 45389.3 48830.8 49099.3 45382.8 45446.3 45901.3 45937.3 45981.0 8833.6 8962.3 8963.2 8972.9 8982.4 8827.3 8840.9 8852.3 8933.5 8962.8 8938.8 8944.9 8969.3 8993.4 9025.5 8917.8 8938.1 8943.8 8945.3 8959.4 8848.9 8872.2 8901.6 8912.1 8929.1 43428.8 43543.0 43662.1 43714.0 43742.1 3572.8 3718.9 3725.3 3768.4 4121.7 32249.2 32251.0 32509.7 32538.7 32696.7 4516.9 4540.5 4557.2 4569.2 4645.7 372144.0 373842.0 376315.0 377886.0 379692.0 59744.0 60136.1 60280.4 60482.0 60551.0 67885.7 68143.3 68424.3 68437.7 68838.7 18364.6 18408.4 18560.4 18578.5 18723.1 14161.9 14336.9 14343.9 14367.0 14420.6 19419.6 20365.3 20601.3 20702.8 20850.3 7491.8 7494.3 7498.4 7673.6 7930.0 984.1 1071.9 1106.7 1132.2 1155.2 33248.5 33426.2 33625.7 33929.8 34072.7 1174.2 1183.3 1198.6 1198.7 1201.2 16466.9 17288.0 17368.2 17593.7 17656.6 505818.0 505910.0 506737.0 508452.0 509044.0 59781.0 60222.4 60279.7 60287.4 60378.0 1447.0 1457.8 1460.7 1492.6 1494.6 31783.5 32030.4 32981.3 33016.7 33278.0 53978.0 54504.0 54715.0 54783.0 54798.5 458404.0 459720.0 461167.0 461916.0 463259.0 29970.9 30091.0 30366.2 30381.5 30605.8 48264.0 48642.5 48679.0 49019.0 49990.5 41186.4 41272.4 41730.0 41827.8 42551.4 41991.6 42025.6 42319.4 42837.1 43117.1 40809.8 40883.8 43272.4 44202.0 46870.0 41539.8 43134.0 44975.6 45532.8 46535.5 34084.3 35833.3 35986.8 36033.6 36208.3 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - PROCESS | 18567 | [#2] jquery.html Cycles:180 Average:28612.19 Median:23716.14 stddev:75314.42 (317.6%) stddev-sans-first:75495.90 13:51:36 INFO - PROCESS | 18567 | Values: 396.5 401.3 425.5 425.9 434.0 19577.4 19707.6 20129.1 20217.2 20297.6 16367.2 17461.8 19640.2 20187.2 20372.0 5506.8 5823.4 5840.3 5877.1 5920.9 5659.7 5747.9 5757.4 5823.4 5843.9 5808.9 5821.7 5825.5 5835.2 5855.6 5635.9 5785.7 5796.2 5803.5 5854.6 5238.2 5240.2 5248.8 5252.3 5265.1 23628.5 23666.6 23765.6 23770.2 24194.8 2679.2 3138.8 3143.8 3208.4 3210.0 12655.7 14520.6 15087.3 15184.4 15634.6 1857.6 1999.4 2007.5 2013.3 2064.9 86788.0 87466.0 89554.0 90432.0 91589.5 10676.8 10803.8 11135.8 11988.4 12152.8 17328.8 17330.6 17394.4 17396.1 17428.3 9057.0 9084.1 9131.3 9181.2 9213.9 8724.1 8744.7 8810.9 9021.7 9027.1 5177.1 5182.8 5210.7 5268.6 5279.9 2037.6 2128.9 2154.3 2155.4 2175.5 917.4 1014.7 1070.8 1097.0 1128.8 19872.7 20283.4 20407.1 20487.7 20837.4 1005.4 1030.7 1053.1 1090.7 1100.7 10611.4 11314.3 11460.2 11511.0 11528.4 438096.0 446485.0 451553.0 464288.0 476643.0 58522.4 61285.7 94276.5 97333.5 97536.5 1072.4 1097.6 1143.3 1182.0 1182.0 18055.5 18205.2 18541.4 18582.7 18753.2 38726.0 43640.3 43743.6 44023.6 44632.3 62842.1 62879.7 63220.7 63654.7 63875.7 8654.3 8796.3 8833.5 8855.5 8972.8 11314.0 13543.5 13624.8 13678.5 13788.1 12011.5 12055.0 12088.4 12108.5 12200.9 11595.3 11620.8 11826.1 11948.0 12129.6 12141.3 12234.7 12263.6 12400.1 12527.9 8632.2 8775.5 8899.0 8908.2 9138.4 11234.6 11698.4 11749.8 11851.5 12424.8 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - PROCESS | 18567 | [#3] mootools.html Cycles:180 Average:5962.80 Median:2787.96 stddev:3337.91 (119.7%) stddev-sans-first:3330.54 13:51:36 INFO - PROCESS | 18567 | Values: 1515.1 1542.1 1712.1 1778.0 1799.7 7972.8 8212.5 8497.2 9130.9 9137.5 8601.9 8814.8 8834.6 9047.0 9119.9 2495.8 2520.9 2537.5 2556.1 2556.1 2326.5 2507.0 2548.8 2558.3 2564.1 2472.1 2491.5 2500.5 2511.6 2520.3 2451.3 2473.1 2495.2 2508.8 2512.2 2434.4 2454.5 2465.3 2480.0 2514.3 9103.5 9116.6 9118.3 9142.0 9166.5 5488.5 5563.3 5584.1 5623.9 5639.8 3556.9 3594.7 3690.6 3791.2 3841.1 1204.4 1226.1 1229.5 1273.8 1276.0 12346.6 12461.6 12471.7 12483.7 12531.7 4959.8 5037.6 5058.6 5069.2 5164.2 10459.6 10535.4 10596.6 10644.1 10669.4 5698.4 5702.1 5711.9 5745.6 5747.6 5049.6 5263.6 5283.6 5288.9 5353.5 3965.5 4057.2 4059.1 4129.4 4145.6 1273.4 1288.1 1301.3 1307.1 1316.5 911.8 968.8 988.9 989.6 998.4 5847.0 5975.5 6079.1 6117.6 6149.0 490.4 498.5 506.7 511.5 515.4 4017.4 4139.2 4158.1 4170.7 4178.4 10877.9 11249.7 11283.7 11319.7 11341.5 10961.8 11051.3 11087.7 11124.7 11159.2 8318.7 8337.7 8600.4 8622.4 8656.5 5768.4 5852.2 5948.4 5950.1 5970.0 9577.8 10161.1 10227.7 10280.6 10401.4 10214.2 10364.1 10372.4 10420.4 10464.6 7312.9 7856.8 7914.9 7926.9 8110.6 8860.2 8861.9 8893.4 8897.2 8903.4 7548.9 7624.2 7718.3 7855.0 7912.4 7709.3 7803.6 7814.5 7822.3 7942.8 7235.7 7277.6 7351.6 7363.8 7455.9 5071.0 5175.9 5296.3 5411.2 5481.3 5084.2 5157.9 5203.1 5337.9 5350.9 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - PROCESS | 18567 | [#4] prototype.html Cycles:180 Average:4981.70 Median:5648.10 stddev:1450.87 (25.7%) stddev-sans-first:1412.73 13:51:36 INFO - PROCESS | 18567 | Values: 352.9 357.6 363.4 364.3 364.4 5641.9 5701.5 5708.3 5720.3 5723.8 5533.6 5642.7 5647.6 5663.5 5677.5 4421.3 4446.8 4459.9 4461.2 4472.2 4450.8 4460.6 4470.0 4472.0 4475.4 4437.8 4443.3 4443.4 4452.0 4480.1 4342.5 4405.9 4443.5 4451.7 4453.4 3948.2 3957.4 3966.7 3967.7 3981.9 5542.0 5544.6 5564.3 5571.9 5573.1 4977.0 5079.5 5114.7 5117.3 5129.8 5847.0 5905.0 5912.2 5917.7 5932.5 4317.6 4348.4 4370.3 4383.2 4390.1 5915.5 5921.3 6098.0 6138.9 6139.0 4311.4 4313.2 4341.1 4341.6 4365.7 4415.5 4417.8 4419.8 4436.9 4438.8 4920.0 5003.5 5078.9 5079.8 5110.7 5918.3 5920.8 5938.7 5962.3 5965.6 1478.1 1481.1 1482.6 1493.4 1497.9 966.9 998.2 1020.3 1027.9 1032.3 5567.8 5577.9 5596.9 5599.0 5599.7 5895.8 5897.4 5900.0 5911.4 5912.3 5493.4 5559.2 5632.7 5657.2 5672.5 3056.9 3105.8 3122.3 3123.0 3133.4 5819.0 6048.5 6068.7 6072.3 6077.7 5888.5 5892.2 5892.4 5930.3 5940.6 6013.1 6034.8 6040.3 6049.9 6102.8 5698.9 5857.2 6048.7 6160.5 6184.2 6076.8 6080.0 6085.2 6087.5 6099.8 5979.4 6096.3 6284.7 6333.2 6417.9 4312.2 4360.6 4366.7 4373.6 4386.4 5903.7 6166.2 6168.9 6184.8 6186.3 6020.7 6022.1 6046.4 6049.8 6073.3 6000.2 6008.1 6011.3 6031.4 6037.8 5648.6 5937.2 5965.6 5970.9 5973.9 5975.9 6000.8 6033.7 6049.8 6052.9 5561.0 5786.0 5832.9 5833.2 5838.7 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - PROCESS | 18567 | [#5] yui.html Cycles:180 Average:18402.08 Median:4793.47 stddev:24096.87 (502.7%) stddev-sans-first:24128.13 13:51:36 INFO - PROCESS | 18567 | Values: 780.2 801.5 835.1 857.4 899.5 14763.8 15420.2 15565.3 15614.7 15678.9 12859.5 12904.7 14733.2 15475.6 15491.2 830.5 846.8 849.7 849.7 850.1 866.2 870.2 870.5 870.7 870.8 901.1 908.0 912.8 914.7 915.2 903.1 905.4 910.1 910.7 913.0 665.3 666.2 666.5 671.7 671.9 14724.2 14803.0 14804.4 14857.8 14867.4 14507.8 14526.7 14726.6 14775.0 15115.5 12079.9 12135.7 12144.1 12308.6 12444.1 3866.1 3902.0 3902.6 3951.2 3973.3 67716.7 69001.0 69854.3 69883.0 71730.6 11222.3 11331.2 11527.8 11528.3 11560.8 20812.6 20968.0 21008.9 21038.9 21374.4 7979.6 7981.5 8108.8 8248.3 8355.2 4807.0 4812.1 4874.2 4891.7 4955.1 3434.4 3486.1 3502.0 3548.4 3561.8 639.8 644.5 648.1 648.6 682.8 700.2 741.9 754.9 774.0 783.9 9002.9 9395.0 9396.8 9484.0 9587.5 678.9 752.3 774.5 789.0 789.3 4623.9 4684.9 4701.5 4782.1 4804.8 94023.0 94104.3 95554.5 95639.5 97031.0 63693.4 75560.2 76088.6 81129.6 83453.6 44906.3 49261.0 64618.4 66733.7 69127.3 9532.4 9781.6 9973.4 10001.7 10063.8 46870.3 46992.3 47729.0 47734.8 48219.5 60912.7 61250.7 65315.7 65943.7 68860.7 12413.4 12754.9 13173.1 13206.8 13259.7 14940.6 15161.0 15238.8 15289.8 15472.8 13623.6 14219.8 14426.6 14585.0 14649.3 13804.1 13869.2 14456.6 14580.1 14930.4 14254.7 14458.2 14463.9 14474.6 14635.9 11408.0 11602.8 12183.5 12197.5 12529.2 11741.6 11753.6 11874.7 11895.8 12259.1 13:51:36 INFO - PROCESS | 18567 | -------- Summary: end -------- 13:51:36 INFO - PROCESS | 18567 | 13:51:36 INFO - TEST-INFO | 18567: exit 0 13:51:36 INFO - TEST-OK | dromaeo_css | took 1114384ms 13:51:36 INFO - TEST-START | kraken 13:51:36 INFO - operating with platform_type : linux_ 13:51:36 INFO - Initialising browser for kraken test... 13:51:36 INFO - TEST-INFO | started process 18936 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmVeMC7/profile http://localhost:49746/getInfo.html) 13:51:41 INFO - PROCESS | 18936 | __metrics Screen width/height:1600/1200 13:51:41 INFO - PROCESS | 18936 | colorDepth:24 13:51:41 INFO - PROCESS | 18936 | Browser inner width/height: 1024/697 13:51:41 INFO - PROCESS | 18936 | __metrics 13:51:42 ERROR - PROCESS | 18936 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3175: TypeError: this.tabs is undefined 13:51:43 INFO - TEST-INFO | 18936: exit 0 13:51:43 INFO - Browser initialized. 13:51:43 INFO - Running cycle 1/1 for kraken test... 13:51:43 INFO - TEST-INFO | started process 19068 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmVeMC7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:51:55 INFO - PROCESS | 19068 | RSS: Main: 151748608 13:51:55 INFO - PROCESS | 19068 | 13:51:57 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49746/tests/kraken/driver.html?testName=audio-beat-detection) 13:51:58 INFO - PROCESS | 19068 | RSS: Main: 157057024 13:51:58 INFO - PROCESS | 19068 | 13:52:01 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49746/tests/kraken/driver.html?testName=audio-dft) 13:52:01 INFO - PROCESS | 19068 | RSS: Main: 155324416 13:52:01 INFO - PROCESS | 19068 | 13:52:04 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49746/tests/kraken/driver.html?testName=audio-fft) 13:52:05 INFO - PROCESS | 19068 | RSS: Main: 155480064 13:52:05 INFO - PROCESS | 19068 | 13:52:07 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49746/tests/kraken/driver.html?testName=audio-oscillator) 13:52:08 INFO - PROCESS | 19068 | RSS: Main: 155443200 13:52:08 INFO - PROCESS | 19068 | 13:52:10 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49746/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:52:10 INFO - PROCESS | 19068 | RSS: Main: 155529216 13:52:10 INFO - PROCESS | 19068 | 13:52:13 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49746/tests/kraken/driver.html?testName=imaging-darkroom) 13:52:14 INFO - PROCESS | 19068 | RSS: Main: 158162944 13:52:14 INFO - PROCESS | 19068 | 13:52:17 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49746/tests/kraken/driver.html?testName=imaging-desaturate) 13:52:18 INFO - PROCESS | 19068 | RSS: Main: 158621696 13:52:18 INFO - PROCESS | 19068 | 13:52:21 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49746/tests/kraken/driver.html?testName=json-parse-financial) 13:52:21 INFO - PROCESS | 19068 | RSS: Main: 158760960 13:52:21 INFO - PROCESS | 19068 | 13:52:23 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49746/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:52:23 INFO - PROCESS | 19068 | RSS: Main: 157515776 13:52:23 INFO - PROCESS | 19068 | 13:52:25 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49746/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:52:26 INFO - PROCESS | 19068 | RSS: Main: 157368320 13:52:26 INFO - PROCESS | 19068 | 13:52:28 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49746/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:52:28 INFO - PROCESS | 19068 | RSS: Main: 157949952 13:52:28 INFO - PROCESS | 19068 | 13:52:31 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49746/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:52:32 INFO - PROCESS | 19068 | RSS: Main: 157880320 13:52:32 INFO - PROCESS | 19068 | 13:52:34 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49746/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:52:35 INFO - PROCESS | 19068 | RSS: Main: 157880320 13:52:35 INFO - PROCESS | 19068 | 13:52:36 INFO - PROCESS | 19068 | Cycle 1(1): loaded http://localhost:49746/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49746/tests/kraken/driver.html?testName=ai-astar) 13:52:37 INFO - PROCESS | 19068 | RSS: Main: 159158272 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | __start_tp_report 13:52:37 INFO - PROCESS | 19068 | _x_x_mozilla_page_load 13:52:37 INFO - PROCESS | 19068 | _x_x_mozilla_page_load_details 13:52:37 INFO - PROCESS | 19068 | |i|pagename|runs| 13:52:37 INFO - PROCESS | 19068 | |0;ai-astar;102;112;113;110;111;111;111;111;109;111 13:52:37 INFO - PROCESS | 19068 | |1;audio-beat-detection;145;122;121;159;124;119;118;119;143;119 13:52:37 INFO - PROCESS | 19068 | |2;audio-dft;162;165;163;162;164;160;161;161;165;162 13:52:37 INFO - PROCESS | 19068 | |3;audio-fft;75;76;75;115;76;76;76;76;109;77 13:52:37 INFO - PROCESS | 19068 | |4;audio-oscillator;83;82;118;83;83;82;95;81;81;112 13:52:37 INFO - PROCESS | 19068 | |5;imaging-gaussian-blur;117;117;118;117;118;118;121;117;118;118 13:52:37 INFO - PROCESS | 19068 | |6;imaging-darkroom;148;147;148;146;149;147;147;147;147;146 13:52:37 INFO - PROCESS | 19068 | |7;imaging-desaturate;85;86;85;86;88;85;85;85;85;84 13:52:37 INFO - PROCESS | 19068 | |8;json-parse-financial;51;54;50;51;51;52;54;53;51;52 13:52:37 INFO - PROCESS | 19068 | |9;json-stringify-tinderbox;58;58;57;57;59;58;58;59;58;58 13:52:37 INFO - PROCESS | 19068 | |10;stanford-crypto-aes;75;74;74;74;75;81;77;76;75;75 13:52:37 INFO - PROCESS | 19068 | |11;stanford-crypto-ccm;127;130;121;123;121;126;123;121;167;123 13:52:37 INFO - PROCESS | 19068 | |12;stanford-crypto-pbkdf2;151;154;155;155;149;158;153;151;154;155 13:52:37 INFO - PROCESS | 19068 | |13;stanford-crypto-sha256-iterative;71;64;62;61;65;62;61;62;61;61 13:52:37 INFO - PROCESS | 19068 | __end_tp_report 13:52:37 INFO - PROCESS | 19068 | __start_cc_report 13:52:37 INFO - PROCESS | 19068 | _x_x_mozilla_cycle_collect,790 13:52:37 INFO - PROCESS | 19068 | __end_cc_report 13:52:37 INFO - PROCESS | 19068 | __startTimestamp1482357157220__endTimestamp 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | ------- Summary: start ------- 13:52:37 INFO - PROCESS | 19068 | Number of tests: 14 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#0] ai-astar Cycles:10 Average:110.10 Median:111.00 stddev:3.03 (2.7%) stddev-sans-first:1.12 13:52:37 INFO - PROCESS | 19068 | Values: 102.0 112.0 113.0 110.0 111.0 111.0 111.0 111.0 109.0 111.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#1] audio-beat-detection Cycles:10 Average:128.90 Median:123.00 stddev:14.57 (11.8%) stddev-sans-first:14.24 13:52:37 INFO - PROCESS | 19068 | Values: 145.0 122.0 121.0 159.0 124.0 119.0 118.0 119.0 143.0 119.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#2] audio-dft Cycles:10 Average:162.50 Median:162.50 stddev:1.72 (1.1%) stddev-sans-first:1.81 13:52:37 INFO - PROCESS | 19068 | Values: 162.0 165.0 163.0 162.0 164.0 160.0 161.0 161.0 165.0 162.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#3] audio-fft Cycles:10 Average:83.10 Median:76.00 stddev:15.31 (20.1%) stddev-sans-first:15.95 13:52:37 INFO - PROCESS | 19068 | Values: 75.0 76.0 75.0 115.0 76.0 76.0 76.0 76.0 109.0 77.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#4] audio-oscillator Cycles:10 Average:90.00 Median:82.50 stddev:13.86 (16.8%) stddev-sans-first:14.47 13:52:37 INFO - PROCESS | 19068 | Values: 83.0 82.0 118.0 83.0 83.0 82.0 95.0 81.0 81.0 112.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#5] imaging-gaussian-blur Cycles:10 Average:117.90 Median:118.00 stddev:1.20 (1.0%) stddev-sans-first:1.22 13:52:37 INFO - PROCESS | 19068 | Values: 117.0 117.0 118.0 117.0 118.0 118.0 121.0 117.0 118.0 118.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#6] imaging-darkroom Cycles:10 Average:147.20 Median:147.00 stddev:0.92 (0.6%) stddev-sans-first:0.93 13:52:37 INFO - PROCESS | 19068 | Values: 148.0 147.0 148.0 146.0 149.0 147.0 147.0 147.0 147.0 146.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#7] imaging-desaturate Cycles:10 Average:85.40 Median:85.00 stddev:1.07 (1.3%) stddev-sans-first:1.13 13:52:37 INFO - PROCESS | 19068 | Values: 85.0 86.0 85.0 86.0 88.0 85.0 85.0 85.0 85.0 84.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#8] json-parse-financial Cycles:10 Average:51.90 Median:52.00 stddev:1.37 (2.6%) stddev-sans-first:1.41 13:52:37 INFO - PROCESS | 19068 | Values: 51.0 54.0 50.0 51.0 51.0 52.0 54.0 53.0 51.0 52.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#9] json-stringify-tinderbox Cycles:10 Average:58.00 Median:58.00 stddev:0.67 (1.1%) stddev-sans-first:0.71 13:52:37 INFO - PROCESS | 19068 | Values: 58.0 58.0 57.0 57.0 59.0 58.0 58.0 59.0 58.0 58.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#10] stanford-crypto-aes Cycles:10 Average:75.60 Median:75.00 stddev:2.12 (2.8%) stddev-sans-first:2.24 13:52:37 INFO - PROCESS | 19068 | Values: 75.0 74.0 74.0 74.0 75.0 81.0 77.0 76.0 75.0 75.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#11] stanford-crypto-ccm Cycles:10 Average:128.20 Median:124.50 stddev:13.95 (11.2%) stddev-sans-first:14.79 13:52:37 INFO - PROCESS | 19068 | Values: 127.0 130.0 121.0 123.0 121.0 126.0 123.0 121.0 167.0 123.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:153.50 Median:154.50 stddev:2.59 (1.7%) stddev-sans-first:2.59 13:52:37 INFO - PROCESS | 19068 | Values: 151.0 154.0 155.0 155.0 149.0 158.0 153.0 151.0 154.0 155.0 13:52:37 INFO - PROCESS | 19068 | 13:52:37 INFO - PROCESS | 19068 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.00 Median:62.00 stddev:3.13 (5.0%) stddev-sans-first:1.45 13:52:37 INFO - PROCESS | 19068 | Values: 71.0 64.0 62.0 61.0 65.0 62.0 61.0 62.0 61.0 61.0 13:52:37 INFO - PROCESS | 19068 | -------- Summary: end -------- 13:52:37 INFO - PROCESS | 19068 | 13:52:38 INFO - TEST-INFO | 19068: exit 0 13:52:38 INFO - TEST-OK | kraken | took 61347ms 13:52:38 INFO - SUITE-END | took 1175s 13:52:38 INFO - Completed test suite (00:19:35) 13:52:38 INFO - javascript benchmark 13:52:38 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7579.254828416937, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3328.3509715605455, 3348.6986171244585, 3362.5796775403082, 3366.2425954160303, 3371.359441706076, 5778.6243894146855, 5807.332156801964, 5840.824775256739, 5849.09339052447, 5874.295084589855, 5779.913301300484, 5851.473367396933, 5862.0913758367415, 5867.794627188049, 5868.2664666916635, 5227.73861306935, 5286.497782710637, 5291.31212942317, 5304.549113325372, 5319.494648008433, 5339.839804805862, 5341.813036543722, 5342.492463216007, 5356.839294821161, 5370.650907690988, 5129.0, 5141.0489059523925, 5306.814261500848, 5339.466053394668, 5339.733013349336, 5161.27742116104, 5174.990876779029, 5243.2659427680155, 5289.576833853283, 5335.999999999961, 5202.375714914235, 5206.661566998133, 5246.580273578143, 5263.6841789492755, 5295.973520132413, 5600.635958662674, 5731.484166425, 5758.481736643722, 5855.121731740231, 5855.473007429309, 6048.304444988838, 6077.848053798691, 6078.696065196723, 6088.726007329681, 6136.325004249529, 6129.969350153221, 6154.44609985099, 6157.661328626924, 6211.25464944205, 6216.316205217422, 5784.248047753765, 5804.1293805929445, 5806.883862322772, 5822.650640961556, 5854.531637468992, 6289.622622642564, 6292.244930608356, 6334.0, 6346.555741098079, 6398.0, 6111.786087486917, 6136.8772624547255, 6138.662373569497, 6141.385861413823, 6208.751649934043, 5984.3417224105315, 6027.126066720301, 6216.937830621636, 6303.558750887394, 6307.5584709070845, 6069.15031895535, 6076.665783381868, 6121.209103132385, 6203.131561581382, 6220.253569571681, 6138.14066030756, 6156.230471191101, 6181.660008699565, 6191.4118158774845, 6203.31763506014, 4621.30680397943, 4755.9286610700865, 4759.833405830779, 4765.475797662254, 4785.617150627942, 4127.236461254677, 4145.91708165841, 4156.210320039183, 4174.123434078817, 4246.639035682002, 5833.300003999547, 5886.852828679232, 5890.67601281925, 5896.233489646319, 5901.616394934315, 6182.0, 6192.566520343533, 6192.876142477216, 6210.472109870621, 6221.191245138103, 5697.316322041382, 5782.277215348082, 5820.330661973842, 5894.705264736746, 5929.05135178378, 5334.093204155303, 5388.649737767033, 5409.756560954766, 5432.266644003088, 5442.374126975369, 6401.1678481798, 6470.9029364559565, 6472.3204063573585, 6479.5788273763, 6515.902261465987, 6040.184575082308, 6121.112438696453, 6134.681512609229, 6292.685365731603, 6295.748170073329, 6365.649889256136, 6491.188601424822, 6492.31830657793, 6504.414602685781, 6513.4463570595135, 6113.052476866093, 6119.663418511846, 6139.4781443577795, 6155.1075094112, 6155.199824022849, 6029.698515074317, 6077.270727512727, 6218.689065546795, 6267.905981410191, 6283.528735344776, 6056.242969628796, 6087.330393656605, 6093.969530152321, 6141.263048434216, 6188.752449902134, 6121.969859688293, 6124.142620033288, 6126.334466363025, 6127.097902969389, 6133.977404287646, 5761.049426844524, 5981.401859813984, 6057.061155520902, 6089.056196289582, 6105.419985101408, 5948.37542058095, 6057.909131363122, 6074.0, 6100.8779824404155, 6142.621558143092, 5935.881282374242, 5961.403859614177, 5968.522518198447, 5990.071538911476, 6000.579959402975], "value": 5716.375888708314, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [584.2813339592301, 610.6885488400916, 634.479726624168, 656.501059195012, 660.8843452395829, 44192.77903610482, 45302.54697453028, 45389.319160212624, 48830.75584622081, 49099.263511047364, 45382.773086134606, 45446.318305225446, 45901.31148032782, 45937.31094033592, 45981.0, 8833.602487888029, 8962.283017358628, 8963.193312601865, 8972.910270897306, 8982.416142950688, 8827.293816494697, 8840.911590884074, 8852.291816654651, 8933.46399216046, 8962.775930601721, 8938.821223575525, 8944.8658270126, 8969.282457403391, 8993.370464067519, 9025.458472491639, 8917.821643567126, 8938.106189381075, 8943.776405589848, 8945.329100317469, 8959.41763785352, 8848.911510884873, 8872.201501864798, 8901.554922253927, 8912.108789121101, 8929.107089291085, 43428.78285608552, 43543.0, 43662.12675746499, 43714.0, 43742.12515749699, 3572.821358932069, 3718.9070273243115, 3725.3480640887738, 3768.3970564709516, 4121.670266378683, 32249.1937701557, 32251.0, 32509.6749032509, 32538.67461325404, 32696.673033269602, 4516.887077823048, 4540.523245059288, 4557.248054071074, 4569.246074397721, 4645.721256724573, 372144.0, 373842.0, 376315.0, 377886.0, 379692.0, 59744.0, 60136.097958530656, 60280.39719602748, 60482.0, 60551.0, 67885.66057169682, 68143.31856681469, 68424.3157568418, 68437.65781171063, 68838.65580672065, 18364.632707346045, 18408.447746567625, 18560.443186704422, 18578.535536611424, 18723.063846807607, 14161.85838141626, 14336.928315358356, 14343.928280358532, 14367.0, 14420.567382978528, 19419.611607767765, 20365.287214947406, 20601.278955236496, 20702.792972070085, 20850.270240541508, 7491.775246742606, 7494.288042635941, 7498.3626391756225, 7673.61631918413, 7929.986605090145, 984.1142971325864, 1071.9142468602492, 1106.7399161197113, 1132.1508868348737, 1155.2086820527797, 33248.501272480935, 33426.16434589106, 33625.66374336274, 33929.83035084809, 34072.65927340695, 1174.1741442670616, 1183.3077649574923, 1198.568515334479, 1198.6823491774687, 1201.1711918776016, 16466.917665411594, 17288.0, 17368.218430170673, 17593.7360939586, 17656.646867062587, 505818.0, 505910.0, 506737.0, 508452.0, 509044.0, 59781.0, 60222.39777602168, 60279.69860150671, 60287.39712602906, 60378.0, 1446.9855301447271, 1457.8031965684709, 1460.715160543705, 1492.6492274315526, 1494.6114010357385, 31783.523247151774, 32030.35939281248, 32981.340373192885, 33016.67933282738, 33278.0, 53978.0, 54504.0, 54715.0, 54783.0, 54798.452015479335, 458404.0, 459720.0, 461167.0, 461916.0, 463259.0, 29970.850145749133, 30091.0, 30366.240843979078, 30381.544276836306, 30605.846970765004, 48264.0, 48642.5135748638, 48679.0, 49019.0, 49990.500094998584, 41186.38220426636, 41272.380914285706, 41730.0, 41827.7908610455, 42551.3617295747, 41991.580084198766, 42025.57974420339, 42319.3652095225, 42837.14325713531, 43117.13765724731, 40809.79595102005, 40883.79558102191, 43272.350914735674, 44202.0, 46870.0, 41539.7923010383, 43134.0, 44975.550244497135, 45532.77233613811, 46535.53464465312, 34084.31831363408, 35833.28333433369, 35986.82006590055, 36033.639663603026, 36208.27583448369], "value": 21233.085463950112, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [396.48457005892334, 401.2977289742948, 425.45541706615523, 425.8956555643868, 433.9631131353835, 19577.412677619675, 19707.605847883035, 20129.094190761414, 20217.191312347524, 20297.59404811903, 16367.181640917966, 17461.82538174621, 19640.21439142436, 20187.192512299527, 20372.0, 5506.752196151163, 5823.446772556622, 5840.299164100314, 5877.147813567051, 5920.851978700523, 5659.66042037477, 5747.856303592402, 5757.395473475288, 5823.359430462667, 5843.8539036524, 5808.912866307009, 5821.6507009579345, 5825.475707186352, 5835.153902684108, 5855.648661080328, 5635.8591035224445, 5785.71071446426, 5796.188533605298, 5803.477687008169, 5854.590178687494, 5238.161894096965, 5240.161574148156, 5248.8425347239645, 5252.317198764136, 5265.104932161542, 23628.527429451486, 23666.64500032501, 23765.643515347285, 23770.168044118374, 24194.758052419427, 2679.1828492309837, 3138.8430578470984, 3143.76421768366, 3208.406444807718, 3210.0209436121972, 12655.683607909783, 14520.564383068524, 15087.321070551852, 15184.392624295015, 15634.609134771608, 1857.619188066443, 1999.430162403708, 2007.5081605006867, 2013.3456626596414, 2064.917403303866, 86788.0, 87466.0, 89554.0, 90432.0, 91589.54205228998, 10676.839847402296, 10803.783924321628, 11135.777284454427, 11988.400579970967, 12152.75694486123, 17328.82671173272, 17330.566735831453, 17394.391196308068, 17396.130193490273, 17428.302867885395, 9056.954715226382, 9084.137006984325, 9131.315151363675, 9181.219596334253, 9213.861792073125, 8724.083971183061, 8744.650213991496, 8810.911890881138, 9021.729348119567, 9027.14242146995, 5177.094008548489, 5182.792688292501, 5210.713410762444, 5268.604854635841, 5279.9208011879855, 2037.5619241863071, 2128.8616239944354, 2154.332157031294, 2155.4180371299976, 2175.4561359660083, 917.4449458077901, 1014.7463134216446, 1070.7751372211924, 1096.9780604387868, 1128.8306753986967, 19872.70190947137, 20283.391498255078, 20407.081681324376, 20487.69268460974, 20837.37487875366, 1005.3666190300064, 1030.6907927621683, 1053.0838170791308, 1090.650991682654, 1100.7193165742685, 10611.416372099455, 11314.264572802906, 11460.19778615489, 11511.0, 11528.423578821026, 438096.0, 446485.0, 451553.0, 464288.0, 476643.0, 58522.41477585255, 61285.693571531854, 94276.52861735647, 97333.51333243288, 97536.51231743796, 1072.383379556758, 1097.5664612478186, 1143.3254379915888, 1181.9586314478952, 1181.9645410637695, 18055.458336249932, 18205.18076686579, 18541.44375668732, 18582.721259180853, 18753.1561079749, 38726.0, 43640.34539481847, 43743.56256437395, 44023.55976440194, 44632.33051504165, 62842.05736914041, 62879.6856015717, 63220.68389658022, 63654.68172659107, 63875.68062159659, 8654.264387527131, 8796.340274479568, 8833.514156721441, 8855.467855756482, 8972.775680608038, 11314.0, 13543.525976590772, 13624.795628065389, 13678.521251756141, 13788.103773254707, 12011.519539218683, 12055.0, 12088.395580220778, 12108.455119519818, 12200.877991219973, 11595.304281743123, 11620.767584648429, 11826.113041522092, 11948.0, 12129.636110916686, 12141.332226727614, 12234.694132646755, 12263.632091037283, 12400.13199076056, 12527.93736031314, 8632.179942905414, 8775.517346546001, 8899.0, 8908.198262156437, 9138.360314777901, 11234.55061797519, 11698.415079245833, 11749.76500470003, 11851.466683999413, 12424.813627795771], "value": 9721.340092649856, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1515.0758037597063, 1542.1209910351097, 1712.1097029544637, 1778.0309731196496, 1799.7300404939258, 7972.840543189132, 8212.54830984297, 8497.19276668717, 9130.863037054442, 9137.543122843856, 8601.870971935426, 8814.82370352594, 8834.646614135443, 9047.009657875273, 9119.863202051958, 2495.8003359731224, 2520.8865601047996, 2537.479816637594, 2556.0670355320267, 2556.0925871315694, 2326.534693061386, 2506.962395564068, 2548.8215824892263, 2558.322044658167, 2564.1410127607182, 2472.1223965492263, 2491.5141547398266, 2500.499900020003, 2511.610700341441, 2520.281719709883, 2451.276873322383, 2473.109680515013, 2495.2264797912703, 2508.79929605632, 2512.1584269269633, 2434.3670645632264, 2454.5459090068393, 2465.3220364399754, 2480.045182604692, 2514.3462699698025, 9103.499307538083, 9116.589753461043, 9118.270538356915, 9141.954290228572, 9166.495842728647, 5488.53347465466, 5563.332400111972, 5584.050711379075, 5623.915641265385, 5639.830805075813, 3556.8577256909693, 3594.712423006153, 3690.5940346562124, 3791.1659434924272, 3841.116543195081, 1204.4158583087196, 1226.1049433913204, 1229.5081967213187, 1273.8216649669055, 1275.9553415630407, 12346.580143283547, 12461.563845265462, 12471.688207794787, 12483.687907802287, 12531.686707832287, 4959.801607935714, 5037.647364684511, 5058.570021548136, 5069.214271787879, 5164.173732202829, 10459.633912813168, 10535.367877927349, 10596.576136954589, 10644.148468122532, 10669.35983840972, 5698.401667824902, 5702.116171993348, 5711.885762284731, 5745.597808153473, 5747.626404283708, 5049.6212784041345, 5263.6315457918345, 5283.6037297202865, 5288.92066619001, 5353.544948679406, 3965.464662270614, 4057.2494088593703, 4059.127287633173, 4129.442525259112, 4145.585441455831, 1273.420593629896, 1288.1112032697408, 1301.3363184775644, 1307.130758045908, 1316.5063101336998, 911.7720569857536, 968.7820240445843, 988.8714467119372, 989.5794287427815, 998.4458625462793, 5846.970765146147, 5975.462208401264, 6079.05774604937, 6117.602355846856, 6149.0, 490.4335492506161, 498.5263999200774, 506.70357840663627, 511.52683767515646, 515.4458956621646, 4017.397390391465, 4139.151473947833, 4158.126793373365, 4170.666346692257, 4178.35235538492, 10877.891221087846, 11249.71875703114, 11283.717907052389, 11319.717007074889, 11341.546338146547, 10961.83557246642, 11051.336919784839, 11087.72280692989, 11124.721881953015, 11159.218854680257, 8318.66725330992, 8337.666493340319, 8600.397972142015, 8622.353323500762, 8656.52389118592, 5768.365479797303, 5852.209951656642, 5948.405159484017, 5950.107483877453, 5969.9701501493955, 9577.760555986157, 10161.136303413998, 10227.693169204937, 10280.588776448858, 10401.375917444977, 10214.182865370603, 10364.067233948981, 10372.429516376369, 10420.374777513374, 10464.63373781914, 7312.926870731225, 7856.84286314282, 7914.920850791418, 7926.920730792618, 8110.594470276581, 8860.158284962918, 8861.867071993796, 8893.421927574687, 8897.199252067086, 8903.421277616933, 7548.886766698613, 7624.237576242332, 7718.266764657348, 7855.0, 7912.36701063925, 7709.3447057000785, 7803.648835802289, 7814.4529882907655, 7822.256885595859, 7942.761717148494, 7235.710571577078, 7277.563346199245, 7351.595662238628, 7363.77908662741, 7455.925440745523, 5070.974645126751, 5175.948240517697, 5296.285001524899, 5411.215373770702, 5481.260029895913, 5084.161113416245, 5157.922631160461, 5203.089459344524, 5337.919931201112, 5350.866228344167], "value": 4737.941684091385, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [352.858856457417, 357.626280536839, 363.3586719440187, 364.27145708582833, 364.35691005375514, 5641.912492377821, 5701.486866182043, 5708.289611752352, 5720.313562372521, 5723.799667011655, 5533.6403133796275, 5642.746076426561, 5647.576431767624, 5663.546916246701, 5677.460641239086, 4421.314696222091, 4446.7776611169475, 4459.9331010034875, 4461.152381047598, 4472.172648060103, 4450.821967121311, 4460.598546130847, 4469.955300446986, 4471.977640111795, 4475.418195634563, 4437.800298986554, 4443.289073748201, 4443.4445694288215, 4451.955480445203, 4480.126375356806, 4342.457192850894, 4405.889852753675, 4443.51184320307, 4451.688381813258, 4453.354263631755, 3948.1511475033008, 3957.445957565943, 3966.682665386762, 3967.7420967637013, 3981.900452488682, 5541.972290138524, 5544.584156188302, 5564.33228012637, 5571.916421253684, 5573.136163894603, 4976.950230497685, 5079.492050794928, 5114.667546609496, 5117.283580298761, 5129.769160387791, 5846.9707651461895, 5905.0, 5912.201852749867, 5917.674527900964, 5932.495737862287, 4317.639943417845, 4348.369486424483, 4370.2570563004365, 4383.211022016036, 4390.100029493946, 5915.526757859361, 5921.348651648315, 6097.969510152421, 6138.907916381258, 6139.048447490691, 4311.353297005474, 4313.245182093121, 4341.131773645284, 4341.565843415633, 4365.694401391872, 4415.51429342772, 4417.823287068545, 4419.779011049434, 4436.933445998313, 4438.844640437569, 4920.0, 5003.524665156804, 5078.949210507848, 5079.764903442473, 5110.71891045996, 5918.260217472816, 5920.822375328747, 5938.732757025944, 5962.25471816023, 5965.55258355625, 1478.1205182916149, 1481.126135580013, 1482.629342664334, 1493.3573069623544, 1497.9176145311894, 966.8791401074866, 998.1964518562481, 1020.3469779341227, 1027.9383237005804, 1032.2516175772505, 5567.832965011056, 5577.860553486195, 5596.916046259309, 5598.972005139948, 5599.720013999284, 5895.793647222326, 5897.439743224387, 5900.0, 5911.379305172981, 5912.3496415394275, 5493.423190565013, 5559.249501317351, 5632.690202038927, 5657.179708942181, 5672.4894759471845, 3056.8930087446834, 3105.82917939511, 3122.2506598416217, 3123.0, 3133.3576616793503, 5819.0, 6048.546359023003, 6068.664893723374, 6072.271327440735, 6077.696115194222, 5888.528917686661, 5892.234009578728, 5892.381299963442, 5930.318013428425, 5940.61386009908, 6013.075815738922, 6034.762873610899, 6040.335563088057, 6049.879002419927, 6102.816915492543, 5698.914516282176, 5857.238558987305, 6048.667323297261, 6160.537959652955, 6184.165137706532, 6076.787312444043, 6080.0, 6085.178500902499, 6087.543434242361, 6099.817005489843, 5979.402059793986, 6096.329403765493, 6284.748610055546, 6333.20834895638, 6417.93582064192, 4312.180685669713, 4360.607545320936, 4366.650667946493, 4373.628241599499, 4386.429764130643, 5903.7048147593305, 6166.229221347332, 6168.876622467616, 6184.783532576338, 6186.288576813724, 6020.742221666875, 6022.09668549721, 6046.365131661112, 6049.848753781191, 6073.271207455134, 6000.189974353407, 6008.098785182257, 6011.27864656244, 6031.36670649593, 6037.78867739627, 5648.63283886546, 5937.198478205387, 5965.552583556164, 5970.910436343545, 5973.880522389615, 5975.940240597538, 6000.759969601167, 6033.698315084316, 6049.78825741097, 6052.878942421215, 5560.9712203240915, 5785.971070144622, 5832.912506312324, 5833.183354330482, 5838.678872661874], "value": 4518.534628665139, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [780.1730166024015, 801.4510060608484, 835.1398059998202, 857.3698331726184, 899.4783025845011, 14763.778543321845, 15420.228988550569, 15565.29956151973, 15614.687706245883, 15678.921605391986, 12859.48562057519, 12904.677383065427, 14733.189674567895, 15475.613109672264, 15491.225438728075, 830.5265998380926, 846.7967687754956, 849.7068511363569, 849.7280870121564, 850.1201256699318, 866.2290561400358, 870.2081106193365, 870.4907629037021, 870.6560908441162, 870.7692461497708, 901.0944001278706, 907.9909200907972, 912.7991841794827, 914.7392992996997, 915.2403505090758, 903.1375036839802, 905.3888625177979, 910.1035480052143, 910.6721580231111, 912.9726108216731, 665.3213722003578, 666.2404858461358, 666.5434177588368, 671.6675245753335, 671.8857794174953, 14724.19016954067, 14803.0, 14804.40782368704, 14857.777133343008, 14867.405303787944, 14507.782383264259, 14526.70946581073, 14726.558203253919, 14775.0, 15115.546533604009, 12079.93960030203, 12135.696607584881, 12144.149909506337, 12308.630741077692, 12444.128910976235, 3866.052817059838, 3902.043999220181, 3902.551206611248, 3951.2097580483733, 3973.3443981742976, 67716.6614166931, 69001.0, 69854.30145698579, 69883.0, 71730.64134679345, 11222.326660400402, 11331.206815522833, 11527.76944461106, 11528.250663706833, 11560.826587601192, 20812.58374832495, 20968.0, 21008.89495552543, 21038.89480552618, 21374.358769236947, 7979.640916158787, 7981.521108733495, 8108.8378232435025, 8248.298894593907, 8355.206255405727, 4807.0, 4812.085703716282, 4874.171390863562, 4891.706497610084, 4955.132851750929, 3434.364642541138, 3486.1104184329856, 3501.9824900875333, 3548.361294966879, 3561.7684850484634, 639.7952655150307, 644.4876323322969, 648.0959062108333, 648.6237981970446, 682.7712716240115, 700.1947760075954, 741.8924255982852, 754.8528037032836, 773.9860782374994, 783.9372850171973, 9002.909970900208, 9395.0, 9396.765080872896, 9484.0, 9587.520623968774, 678.8913773796169, 752.2853289375006, 774.4617490843922, 789.0176729971223, 789.3369569561481, 4623.884402889955, 4684.929726054112, 4701.529847015271, 4782.139214941274, 4804.807807687724, 94023.0, 94104.32648663675, 95554.52222738841, 95639.52180239193, 97031.0, 63693.36306636967, 75560.24439755532, 76088.61955690297, 81129.59435202905, 83453.58273208595, 44906.3264051033, 49261.0, 64618.35381646217, 66733.666331669, 69127.30872691209, 9532.380395274286, 9781.60873565078, 9973.351732137387, 10001.699949001542, 10063.798724025624, 46870.29694554516, 46992.29511557261, 47729.0, 47734.76132619315, 48219.5178048215, 60912.69543652253, 61250.69374653098, 65315.67342163449, 65943.67028164829, 68860.6556967212, 12413.44139513706, 12754.872451275369, 13173.143745656886, 13206.801897971345, 13259.734805304033, 14940.551783446514, 15161.0, 15238.847611524187, 15289.847101528841, 15472.845271547141, 13623.591292261248, 14219.786703199667, 14426.567202983928, 14585.0, 14649.26753662334, 13804.102733322303, 13869.237191954137, 14456.638584035063, 14580.125192488485, 14930.402783888523, 14254.714905702036, 14458.204798736171, 14463.927680361952, 14474.565763027125, 14635.92682036583, 11408.0, 11602.76794464123, 12183.451744671334, 12197.451114700038, 12529.248245104958, 11741.55656369404, 11753.647390578297, 11874.703132421759, 11895.762084758084, 12259.080568957186], "value": 7503.584221798335, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1455.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 112.0, 113.0, 110.0, 111.0, 111.0, 111.0, 111.0, 109.0, 111.0], "value": 110.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 122.0, 121.0, 159.0, 124.0, 119.0, 118.0, 119.0, 143.0, 119.0], "value": 128.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 165.0, 163.0, 162.0, 164.0, 160.0, 161.0, 161.0, 165.0, 162.0], "value": 162.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 75.0, 115.0, 76.0, 76.0, 76.0, 76.0, 109.0, 77.0], "value": 83.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 82.0, 118.0, 83.0, 83.0, 82.0, 95.0, 81.0, 81.0, 112.0], "value": 90.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 118.0, 117.0, 118.0, 118.0, 121.0, 117.0, 118.0, 118.0], "value": 117.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 148.0, 146.0, 149.0, 147.0, 147.0, 147.0, 147.0, 146.0], "value": 147.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 86.0, 85.0, 86.0, 88.0, 85.0, 85.0, 85.0, 85.0, 84.0], "value": 85.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [51.0, 54.0, 50.0, 51.0, 51.0, 52.0, 54.0, 53.0, 51.0, 52.0], "value": 51.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 58.0, 57.0, 57.0, 59.0, 58.0, 58.0, 59.0, 58.0, 58.0], "value": 58.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 74.0, 74.0, 75.0, 81.0, 77.0, 76.0, 75.0, 75.0], "value": 75.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [127.0, 130.0, 121.0, 123.0, 121.0, 126.0, 123.0, 121.0, 167.0, 123.0], "value": 128.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 154.0, 155.0, 155.0, 149.0, 158.0, 153.0, 151.0, 154.0, 155.0], "value": 153.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 64.0, 62.0, 61.0, 65.0, 62.0, 61.0, 62.0, 61.0, 61.0], "value": 63.0, "unit": "score"}]}]} 13:52:38 INFO - Return code: 0 13:52:38 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:52:38 ERROR - # TBPL SUCCESS # 13:52:38 INFO - Running post-action listener: _resource_record_post_action 13:52:38 INFO - [mozharness: 2016-12-21 21:52:38.507308Z] Finished run-tests step (success) 13:52:38 INFO - Running post-run listener: _resource_record_post_run 13:52:38 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 266240; Write bytes: 363433984; Read time: 28; Write time: 544336 13:52:38 INFO - TinderboxPrint: CPU usage
13.3% 13:52:38 INFO - TinderboxPrint: I/O read bytes / time
266,240 / 28 13:52:38 INFO - TinderboxPrint: I/O write bytes / time
363,433,984 / 544,336 13:52:38 INFO - TinderboxPrint: CPU idle
8,240.8 (86.7%) 13:52:38 INFO - TinderboxPrint: CPU user
1,207.4 (12.7%) 13:52:38 INFO - TinderboxPrint: Swap in / out
0 / 0 13:52:38 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 118620160; Read time: 0; Write time: 137580 13:52:38 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 262144; Write bytes: 243793920; Read time: 12; Write time: 406720 13:52:39 INFO - Running post-run listener: _upload_blobber_files 13:52:39 INFO - Blob upload gear active. 13:52:39 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:52:39 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 13:52:39 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'] 13:52:39 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 13:52:39 INFO - (blobuploader) - INFO - Open directory for files ... 13:52:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:52:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:52:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:52:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:52:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:52:40 INFO - (blobuploader) - INFO - Done attempting. 13:52:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:52:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:52:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:52:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:52:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:52:44 INFO - (blobuploader) - INFO - Done attempting. 13:52:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:52:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:52:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:52:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:52:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:52:45 INFO - (blobuploader) - INFO - Done attempting. 13:52:45 INFO - (blobuploader) - INFO - Iteration through files over. 13:52:45 INFO - Return code: 0 13:52:45 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:52:45 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:52:45 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/353b59ea9cfcf886e889d9629358c042ace9e8f04667ad15c2c51e8e276259f72ce939f8de150591a2994e2ba7b93e4b21024ea1bbb5d0a6226af9b2d33d1380", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e95e33be84f40329d248fbebca0e035064410601ec1b272df2c95ec78c9f9bbeff805938b33d98479c1bd2b9098d2f622edc5cfbac12341201abef3d674c8717", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/06bee49bc4d3fbf966330a619d33d91e3afb5d6258d65c9efee773968c1e584d2acadb99e15ce160b604bd971fe62cfbfd168ba04c2020350577bc8aceb17903"} 13:52:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:52:45 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:52:45 INFO - Contents: 13:52:45 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/353b59ea9cfcf886e889d9629358c042ace9e8f04667ad15c2c51e8e276259f72ce939f8de150591a2994e2ba7b93e4b21024ea1bbb5d0a6226af9b2d33d1380", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e95e33be84f40329d248fbebca0e035064410601ec1b272df2c95ec78c9f9bbeff805938b33d98479c1bd2b9098d2f622edc5cfbac12341201abef3d674c8717", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/06bee49bc4d3fbf966330a619d33d91e3afb5d6258d65c9efee773968c1e584d2acadb99e15ce160b604bd971fe62cfbfd168ba04c2020350577bc8aceb17903"} 13:52:45 INFO - Running post-run listener: copy_logs_to_upload_dir 13:52:45 INFO - Copying logs to upload dir... 13:52:45 INFO - mkdir: /builds/slave/test/build/upload/logs 13:52:45 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.122292 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-12-21 13:52:45.465904) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-21 13:52:45.469773) ========= 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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/353b59ea9cfcf886e889d9629358c042ace9e8f04667ad15c2c51e8e276259f72ce939f8de150591a2994e2ba7b93e4b21024ea1bbb5d0a6226af9b2d33d1380", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e95e33be84f40329d248fbebca0e035064410601ec1b272df2c95ec78c9f9bbeff805938b33d98479c1bd2b9098d2f622edc5cfbac12341201abef3d674c8717", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/06bee49bc4d3fbf966330a619d33d91e3afb5d6258d65c9efee773968c1e584d2acadb99e15ce160b604bd971fe62cfbfd168ba04c2020350577bc8aceb17903"} build_url:https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011954 build_url: 'https://queue.taskcluster.net/v1/task/dSuimlecQFqtDaxIunuRag/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/353b59ea9cfcf886e889d9629358c042ace9e8f04667ad15c2c51e8e276259f72ce939f8de150591a2994e2ba7b93e4b21024ea1bbb5d0a6226af9b2d33d1380", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e95e33be84f40329d248fbebca0e035064410601ec1b272df2c95ec78c9f9bbeff805938b33d98479c1bd2b9098d2f622edc5cfbac12341201abef3d674c8717", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/06bee49bc4d3fbf966330a619d33d91e3afb5d6258d65c9efee773968c1e584d2acadb99e15ce160b604bd971fe62cfbfd168ba04c2020350577bc8aceb17903"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-21 13:52:45.496908) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-21 13:52:45.497282) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=edae0fb5fee9fb758e8af6d3000002a4-1482354354.40527-1192718593 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004494 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-21 13:52:45.579601) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-21 13:52:45.579957) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-21 13:52:45.580298) ========= ========= Total master_lag: 0.18 =========