builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-011 starttime: 1467406998.27 results: success (0) buildid: 20160701113033 builduid: 662a73bfb8d94b6b8059043677934183 revision: 7d431089a2d2c584bea146b354b06026c80291a1 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.270623) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.271309) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.271813) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.290722) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.291170) ========= 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=5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-01 14:03:18-- 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: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 32.6M=0s 2016-07-01 14:03:18 (32.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.088301 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.403596) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.403940) ========= 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=5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020867 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.469331) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:18.469701) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 7d431089a2d2c584bea146b354b06026c80291a1 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 7d431089a2d2c584bea146b354b06026c80291a1 --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=5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-01 14:03:18,963 truncating revision to first 12 chars 2016-07-01 14:03:18,963 Setting DEBUG logging. 2016-07-01 14:03:18,963 attempt 1/10 2016-07-01 14:03:18,963 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/7d431089a2d2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-01 14:03:19,289 unpacking tar archive at: fx-team-7d431089a2d2/testing/mozharness/ program finished with exit code 0 elapsedTime=0.679667 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:19.167427) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:19.167793) ========= script_repo_revision: 7d431089a2d2c584bea146b354b06026c80291a1 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:19.168275) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:19.168603) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-01 14:03:19.178719) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-07-01 14:03:19.179105) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 14:03:19 INFO - MultiFileLogger online at 20160701 14:03:19 in /builds/slave/test 14:03:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 14:03:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 14:03:19 INFO - {'append_to_log': False, 14:03:19 INFO - 'base_work_dir': '/builds/slave/test', 14:03:19 INFO - 'blob_upload_branch': 'Fx-Team', 14:03:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 14:03:19 INFO - 'branch': 'Fx-Team', 14:03:19 INFO - 'buildbot_json_path': 'buildprops.json', 14:03:19 INFO - 'config_files': ('talos/linux_config.py',), 14:03:19 INFO - 'default_actions': ('clobber', 14:03:19 INFO - 'read-buildbot-config', 14:03:19 INFO - 'download-and-extract', 14:03:19 INFO - 'populate-webroot', 14:03:19 INFO - 'create-virtualenv', 14:03:19 INFO - 'install', 14:03:19 INFO - 'run-tests'), 14:03:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 14:03:19 INFO - 'download_minidump_stackwalk': True, 14:03:19 INFO - 'download_symbols': 'ondemand', 14:03:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 14:03:19 INFO - 'tooltool.py': '/tools/tooltool.py', 14:03:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 14:03:19 INFO - '/tools/misc-python/virtualenv.py')}, 14:03:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 14:03:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 14:03:19 INFO - 'installer_path': 'installer.exe', 14:03:19 INFO - 'log_level': 'info', 14:03:19 INFO - 'log_name': 'talos', 14:03:19 INFO - 'log_to_console': True, 14:03:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 14:03:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 14:03:19 INFO - 'opt_config_files': (), 14:03:19 INFO - 'pip_index': False, 14:03:19 INFO - 'sps_profile': False, 14:03:19 INFO - 'sps_profile_interval': 0, 14:03:19 INFO - 'suite': 'dromaeojs', 14:03:19 INFO - 'system_bits': '32', 14:03:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 14:03:19 INFO - 'title': 'talos-linux64-ix-011', 14:03:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 14:03:19 INFO - 'use_talos_json': True, 14:03:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 14:03:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 14:03:19 INFO - 'work_dir': 'build'} 14:03:19 INFO - ##### 14:03:19 INFO - ##### Running clobber step. 14:03:19 INFO - ##### 14:03:19 INFO - Running pre-action listener: _resource_record_pre_action 14:03:19 INFO - Running main action method: clobber 14:03:19 INFO - rmtree: /builds/slave/test/build 14:03:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 14:03:20 INFO - Running post-action listener: _resource_record_post_action 14:03:20 INFO - ##### 14:03:20 INFO - ##### Finished clobber step (success) 14:03:20 INFO - ##### 14:03:20 INFO - ##### 14:03:20 INFO - ##### Running read-buildbot-config step. 14:03:20 INFO - ##### 14:03:20 INFO - Running pre-action listener: _resource_record_pre_action 14:03:20 INFO - Running main action method: read_buildbot_config 14:03:20 INFO - Using buildbot properties: 14:03:20 INFO - { 14:03:20 INFO - "project": "", 14:03:20 INFO - "product": "firefox", 14:03:20 INFO - "script_repo_revision": "production", 14:03:20 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 14:03:20 INFO - "repository": "", 14:03:20 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 14:03:20 INFO - "buildid": "20160701113033", 14:03:20 INFO - "pgo_build": "True", 14:03:20 INFO - "basedir": "/builds/slave/test", 14:03:20 INFO - "buildnumber": 853, 14:03:20 INFO - "slavename": "talos-linux64-ix-011", 14:03:20 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 14:03:20 INFO - "platform": "ubuntu64_hw", 14:03:20 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 14:03:20 INFO - "branch": "fx-team", 14:03:20 INFO - "repo_path": "integration/fx-team", 14:03:20 INFO - "revision": "7d431089a2d2c584bea146b354b06026c80291a1", 14:03:20 INFO - "stage_platform": "linux64-pgo", 14:03:20 INFO - "builduid": "662a73bfb8d94b6b8059043677934183", 14:03:20 INFO - "slavebuilddir": "test" 14:03:20 INFO - } 14:03:20 INFO - Found installer url https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 14:03:20 INFO - Running post-action listener: _resource_record_post_action 14:03:20 INFO - ##### 14:03:20 INFO - ##### Finished read-buildbot-config step (success) 14:03:20 INFO - ##### 14:03:20 INFO - ##### 14:03:20 INFO - ##### Running download-and-extract step. 14:03:20 INFO - ##### 14:03:20 INFO - Running pre-action listener: _resource_record_pre_action 14:03:20 INFO - Running main action method: download_and_extract 14:03:20 INFO - mkdir: /builds/slave/test/build/tests 14:03:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:20 INFO - https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 14:03:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 14:03:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 14:03:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 14:03:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 14:03:24 INFO - Downloaded 1361 bytes. 14:03:24 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 14:03:24 INFO - Using the following test package requirements: 14:03:24 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 14:03:24 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 14:03:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 14:03:24 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 14:03:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 14:03:24 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 14:03:24 INFO - u'jsshell-linux-x86_64.zip'], 14:03:24 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 14:03:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 14:03:24 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 14:03:24 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 14:03:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 14:03:24 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 14:03:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 14:03:24 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 14:03:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 14:03:24 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 14:03:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 14:03:24 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 14:03:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:24 INFO - https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 14:03:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 14:03:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 14:03:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 14:03:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:03:25 INFO - Downloaded 24270693 bytes. 14:03:25 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:03:25 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 14:03:26 INFO - Return code: 0 14:03:26 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 14:03: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:26 INFO - https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 14:03:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 14:03:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 14:03:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 14:03:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:03:28 INFO - Downloaded 24270693 bytes. 14:03:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:03:28 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 14:03:30 INFO - Return code: 0 14:03:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:30 INFO - https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 14:03:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 14:03:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 14:03:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 14:03:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 14:03:31 INFO - Downloaded 14405242 bytes. 14:03:31 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:03:31 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 14:03:31 INFO - Return code: 0 14:03: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:31 INFO - https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 14:03:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 14:03:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 14:03:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 14:03:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 14:03:32 INFO - Downloaded 60337371 bytes. 14:03:32 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 14:03:32 INFO - mkdir: /builds/slave/test/properties 14:03:32 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 14:03:32 INFO - Writing to file /builds/slave/test/properties/build_url 14:03:32 INFO - Contents: 14:03:32 INFO - build_url:https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 14:03:33 INFO - Running post-action listener: _resource_record_post_action 14:03:33 INFO - Running post-action listener: set_extra_try_arguments 14:03:33 INFO - ##### 14:03:33 INFO - ##### Finished download-and-extract step (success) 14:03:33 INFO - ##### 14:03:33 INFO - ##### 14:03:33 INFO - ##### Running populate-webroot step. 14:03:33 INFO - ##### 14:03:33 INFO - Running pre-action listener: _resource_record_pre_action 14:03:33 INFO - Running main action method: populate_webroot 14:03:33 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 14:03:33 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 14:03:33 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 14:03:33 INFO - '--tppagecycles', 14:03:33 INFO - '7'], 14:03:33 INFO - 'tests': ['tsvgm']}}, 14:03:33 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['tresize', 'tcanvasmark']}, 14:03:33 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 14:03:33 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['dromaeo_css', 'kraken']}, 14:03:33 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 14:03:33 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:03:33 INFO - 'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:03:33 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:03:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:03:33 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:03:33 INFO - 'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['damp', 'tps']}, 14:03:33 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:03:33 INFO - 'tests': ['damp', 'tps']}, 14:03:33 INFO - 'g3': {'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['dromaeo_dom']}, 14:03:33 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 14:03:33 INFO - 'g4': {'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['basic_compositor_video']}, 14:03:33 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 14:03:33 INFO - 'other': {'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['a11yr', 14:03:33 INFO - 'ts_paint', 14:03:33 INFO - 'tpaint', 14:03:33 INFO - 'sessionrestore', 14:03:33 INFO - 'sessionrestore_no_auto_restore', 14:03:33 INFO - 'tabpaint']}, 14:03:33 INFO - 'other-e10s': {'tests': ['a11yr', 14:03:33 INFO - 'ts_paint', 14:03:33 INFO - 'tpaint', 14:03:33 INFO - 'sessionrestore', 14:03:33 INFO - 'sessionrestore_no_auto_restore', 14:03:33 INFO - 'tabpaint']}, 14:03:33 INFO - 'other-e10s_l64': {'tests': ['a11yr', 14:03:33 INFO - 'ts_paint', 14:03:33 INFO - 'tpaint', 14:03:33 INFO - 'sessionrestore', 14:03:33 INFO - 'sessionrestore_no_auto_restore', 14:03:33 INFO - 'tabpaint']}, 14:03:33 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 14:03:33 INFO - 'ts_paint', 14:03:33 INFO - 'tpaint', 14:03:33 INFO - 'sessionrestore', 14:03:33 INFO - 'sessionrestore_no_auto_restore', 14:03:33 INFO - 'tabpaint']}, 14:03:33 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['a11yr', 14:03:33 INFO - 'ts_paint', 14:03:33 INFO - 'tpaint', 14:03:33 INFO - 'sessionrestore', 14:03:33 INFO - 'sessionrestore_no_auto_restore', 14:03:33 INFO - 'tabpaint']}, 14:03:33 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['a11yr', 14:03:33 INFO - 'ts_paint', 14:03:33 INFO - 'tpaint', 14:03:33 INFO - 'sessionrestore', 14:03:33 INFO - 'sessionrestore_no_auto_restore', 14:03:33 INFO - 'tabpaint']}, 14:03:33 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['tsvgx', 14:03:33 INFO - 'tsvgr_opacity', 14:03:33 INFO - 'tart', 14:03:33 INFO - 'tscrollx', 14:03:33 INFO - 'cart']}, 14:03:33 INFO - 'svgr-e10s': {'tests': ['tsvgx', 14:03:33 INFO - 'tsvgr_opacity', 14:03:33 INFO - 'tart', 14:03:33 INFO - 'tscrollx', 14:03:33 INFO - 'cart']}, 14:03:33 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:03:33 INFO - 'talos_options': ['--disable-e10s'], 14:03:33 INFO - 'tests': ['tp5o']}, 14:03:33 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:03:33 INFO - 'tests': ['tp5o']}, 14:03:33 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:03:33 INFO - 'talos_options': ['--disable-e10s', 14:03:33 INFO - '--xperf_path', 14:03:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:03:33 INFO - 'tests': ['tp5n']}, 14:03:33 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:03:33 INFO - 'talos_options': ['--xperf_path', 14:03:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:03:33 INFO - 'tests': ['tp5n']}}, 14:03:33 INFO - 'talos.zip': {'path': '', 14:03:33 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 14:03:33 INFO - Running post-action listener: _resource_record_post_action 14:03:33 INFO - ##### 14:03:33 INFO - ##### Finished populate-webroot step (success) 14:03:33 INFO - ##### 14:03:33 INFO - ##### 14:03:33 INFO - ##### Running create-virtualenv step. 14:03:33 INFO - ##### 14:03:33 INFO - Running pre-action listener: _resource_record_pre_action 14:03:33 INFO - Running main action method: create_virtualenv 14:03:33 INFO - Creating virtualenv /builds/slave/test/build/venv 14:03:33 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 14:03:33 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 14:03:33 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 14:03:33 INFO - Using real prefix '/usr' 14:03:33 INFO - New python executable in /builds/slave/test/build/venv/bin/python 14:03:34 INFO - Installing distribute.............................................................................................................................................................................................done. 14:03:35 INFO - Installing pip.................done. 14:03:35 INFO - Return code: 0 14:03:35 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 14:03:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:35 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 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:35 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 14:03:35 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 14:03:35 INFO - Using env: {'DISPLAY': ':0', 14:03:35 INFO - 'HOME': '/home/cltbld', 14:03:35 INFO - 'LANG': 'en_US.UTF-8', 14:03:35 INFO - 'LANGUAGE': 'en_US:en', 14:03:35 INFO - 'LOGNAME': 'cltbld', 14:03:35 INFO - 'MAIL': '/var/mail/cltbld', 14:03:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:35 INFO - 'MOZ_NO_REMOTE': '1', 14:03:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:35 INFO - 'NO_EM_RESTART': '1', 14:03:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:35 INFO - 'PWD': '/builds/slave/test', 14:03:35 INFO - 'SHELL': '/bin/bash', 14:03:35 INFO - 'SHLVL': '1', 14:03:35 INFO - 'TERM': 'linux', 14:03:35 INFO - 'TMOUT': '86400', 14:03:35 INFO - 'USER': 'cltbld', 14:03:35 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:35 INFO - '_': '/tools/buildbot/bin/python'} 14:03:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:36 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 14:03:36 INFO - Cleaning up... 14:03:36 INFO - Return code: 0 14:03:36 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 14:03:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 14:03:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 14:03:36 INFO - Using env: {'DISPLAY': ':0', 14:03:36 INFO - 'HOME': '/home/cltbld', 14:03:36 INFO - 'LANG': 'en_US.UTF-8', 14:03:36 INFO - 'LANGUAGE': 'en_US:en', 14:03:36 INFO - 'LOGNAME': 'cltbld', 14:03:36 INFO - 'MAIL': '/var/mail/cltbld', 14:03:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:36 INFO - 'MOZ_NO_REMOTE': '1', 14:03:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:36 INFO - 'NO_EM_RESTART': '1', 14:03:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:36 INFO - 'PWD': '/builds/slave/test', 14:03:36 INFO - 'SHELL': '/bin/bash', 14:03:36 INFO - 'SHLVL': '1', 14:03:36 INFO - 'TERM': 'linux', 14:03:36 INFO - 'TMOUT': '86400', 14:03:36 INFO - 'USER': 'cltbld', 14:03:36 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:36 INFO - '_': '/tools/buildbot/bin/python'} 14:03:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:36 INFO - Downloading/unpacking psutil>=3.1.1 14:03: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 14:03: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 14:03: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 14:03: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 14:03: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 14:03: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 14:03:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 14:03:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:03:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:03:38 INFO - Installing collected packages: psutil 14:03:38 INFO - Running setup.py install for psutil 14:03:38 INFO - building 'psutil._psutil_linux' extension 14:03:38 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 14:03:38 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 14:03:38 INFO - building 'psutil._psutil_posix' extension 14:03:38 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 14:03:38 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 14:03:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:03:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:03:38 INFO - Successfully installed psutil 14:03:38 INFO - Cleaning up... 14:03:38 INFO - Return code: 0 14:03:38 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 14:03:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 14:03:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 14:03:38 INFO - Using env: {'DISPLAY': ':0', 14:03:38 INFO - 'HOME': '/home/cltbld', 14:03:38 INFO - 'LANG': 'en_US.UTF-8', 14:03:38 INFO - 'LANGUAGE': 'en_US:en', 14:03:38 INFO - 'LOGNAME': 'cltbld', 14:03:38 INFO - 'MAIL': '/var/mail/cltbld', 14:03:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:38 INFO - 'MOZ_NO_REMOTE': '1', 14:03:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:38 INFO - 'NO_EM_RESTART': '1', 14:03:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:38 INFO - 'PWD': '/builds/slave/test', 14:03:38 INFO - 'SHELL': '/bin/bash', 14:03:38 INFO - 'SHLVL': '1', 14:03:38 INFO - 'TERM': 'linux', 14:03:38 INFO - 'TMOUT': '86400', 14:03:38 INFO - 'USER': 'cltbld', 14:03:38 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:38 INFO - '_': '/tools/buildbot/bin/python'} 14:03:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:39 INFO - Downloading/unpacking mozsystemmonitor==0.3 14:03:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:03:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:03:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:03:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:03:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:03:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:03:41 INFO - Downloading mozsystemmonitor-0.3.tar.gz 14:03:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 14:03:41 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 14:03:41 INFO - Installing collected packages: mozsystemmonitor 14:03:41 INFO - Running setup.py install for mozsystemmonitor 14:03:41 INFO - Successfully installed mozsystemmonitor 14:03:41 INFO - Cleaning up... 14:03:41 INFO - Return code: 0 14:03:41 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 14:03: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:41 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 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:41 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 14:03:41 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 14:03:41 INFO - Using env: {'DISPLAY': ':0', 14:03:41 INFO - 'HOME': '/home/cltbld', 14:03:41 INFO - 'LANG': 'en_US.UTF-8', 14:03:41 INFO - 'LANGUAGE': 'en_US:en', 14:03:41 INFO - 'LOGNAME': 'cltbld', 14:03:41 INFO - 'MAIL': '/var/mail/cltbld', 14:03:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:41 INFO - 'MOZ_NO_REMOTE': '1', 14:03:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:41 INFO - 'NO_EM_RESTART': '1', 14:03:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:41 INFO - 'PWD': '/builds/slave/test', 14:03:41 INFO - 'SHELL': '/bin/bash', 14:03:41 INFO - 'SHLVL': '1', 14:03:41 INFO - 'TERM': 'linux', 14:03:41 INFO - 'TMOUT': '86400', 14:03:41 INFO - 'USER': 'cltbld', 14:03:41 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:41 INFO - '_': '/tools/buildbot/bin/python'} 14:03:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:41 INFO - Downloading/unpacking jsonschema==2.5.1 14:03:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:03:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:03:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:03:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:03:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:03:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:03:43 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 14:03:43 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 14:03: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 14:03: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 14:03: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 14:03: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 14:03: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 14:03: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 14:03:43 INFO - Downloading functools32-3.2.3-2.tar.gz 14:03:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 14:03:43 INFO - warning: no files found matching '*.txt' 14:03:43 INFO - no previously-included directories found matching 'build' 14:03:43 INFO - no previously-included directories found matching 'dist' 14:03:43 INFO - no previously-included directories found matching '.git*' 14:03:43 INFO - Installing collected packages: jsonschema, functools32 14:03:43 INFO - Running setup.py install for functools32 14:03:43 INFO - warning: no files found matching '*.txt' 14:03:43 INFO - no previously-included directories found matching 'build' 14:03:43 INFO - no previously-included directories found matching 'dist' 14:03:43 INFO - no previously-included directories found matching '.git*' 14:03:43 INFO - Successfully installed jsonschema functools32 14:03:43 INFO - Cleaning up... 14:03:43 INFO - Return code: 0 14:03:43 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 14:03:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:43 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 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:43 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 14:03:43 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 14:03:43 INFO - Using env: {'DISPLAY': ':0', 14:03:43 INFO - 'HOME': '/home/cltbld', 14:03:43 INFO - 'LANG': 'en_US.UTF-8', 14:03:43 INFO - 'LANGUAGE': 'en_US:en', 14:03:43 INFO - 'LOGNAME': 'cltbld', 14:03:43 INFO - 'MAIL': '/var/mail/cltbld', 14:03:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:43 INFO - 'MOZ_NO_REMOTE': '1', 14:03:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:43 INFO - 'NO_EM_RESTART': '1', 14:03:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:43 INFO - 'PWD': '/builds/slave/test', 14:03:43 INFO - 'SHELL': '/bin/bash', 14:03:43 INFO - 'SHLVL': '1', 14:03:43 INFO - 'TERM': 'linux', 14:03:43 INFO - 'TMOUT': '86400', 14:03:43 INFO - 'USER': 'cltbld', 14:03:43 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:43 INFO - '_': '/tools/buildbot/bin/python'} 14:03:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:44 INFO - Downloading/unpacking blobuploader==1.2.4 14:03:44 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 14:03:44 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 14:03:44 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 14:03:44 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 14:03:44 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 14:03:44 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 14:03:45 INFO - Downloading blobuploader-1.2.4.tar.gz 14:03:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 14:03:45 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 14:03:45 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 14:03:45 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 14:03:45 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 14:03:45 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 14:03:45 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 14:03:45 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 14:03:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 14:03:46 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 14:03:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:03:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:03:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:03:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:03:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:03:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:03:46 INFO - Downloading docopt-0.6.1.tar.gz 14:03:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 14:03:46 INFO - Installing collected packages: blobuploader, requests, docopt 14:03:46 INFO - Running setup.py install for blobuploader 14:03:46 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 14:03:46 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 14:03:46 INFO - Running setup.py install for requests 14:03:47 INFO - Running setup.py install for docopt 14:03:47 INFO - Successfully installed blobuploader requests docopt 14:03:47 INFO - Cleaning up... 14:03:47 INFO - Return code: 0 14:03:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:03:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:47 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 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:47 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 14:03:47 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 14:03:47 INFO - Using env: {'DISPLAY': ':0', 14:03:47 INFO - 'HOME': '/home/cltbld', 14:03:47 INFO - 'LANG': 'en_US.UTF-8', 14:03:47 INFO - 'LANGUAGE': 'en_US:en', 14:03:47 INFO - 'LOGNAME': 'cltbld', 14:03:47 INFO - 'MAIL': '/var/mail/cltbld', 14:03:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:47 INFO - 'MOZ_NO_REMOTE': '1', 14:03:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:47 INFO - 'NO_EM_RESTART': '1', 14:03:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:47 INFO - 'PWD': '/builds/slave/test', 14:03:47 INFO - 'SHELL': '/bin/bash', 14:03:47 INFO - 'SHLVL': '1', 14:03:47 INFO - 'TERM': 'linux', 14:03:47 INFO - 'TMOUT': '86400', 14:03:47 INFO - 'USER': 'cltbld', 14:03:47 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:47 INFO - '_': '/tools/buildbot/bin/python'} 14:03:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:03:47 INFO - Running setup.py (path:/tmp/pip-anPKa_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:03:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:03:47 INFO - Running setup.py (path:/tmp/pip-SC5mUF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:03:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:03:47 INFO - Running setup.py (path:/tmp/pip-Kz7pk7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:03:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:03:47 INFO - Running setup.py (path:/tmp/pip-YopQfz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:03:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:03:47 INFO - Running setup.py (path:/tmp/pip-hoHFwk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:03:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:03:47 INFO - Running setup.py (path:/tmp/pip-HRwXjx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:03:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:03:47 INFO - Running setup.py (path:/tmp/pip-WkMksv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:03:48 INFO - Running setup.py (path:/tmp/pip-0ytzrj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:03:48 INFO - Running setup.py (path:/tmp/pip-981siQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:03:48 INFO - Running setup.py (path:/tmp/pip-kyoXox-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:03:48 INFO - Running setup.py (path:/tmp/pip-QnVV7Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:03:48 INFO - Running setup.py (path:/tmp/pip-9nH91f-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:03:48 INFO - Running setup.py (path:/tmp/pip-hTyAbw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:03:48 INFO - Running setup.py (path:/tmp/pip-0L3XYy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:03:48 INFO - Running setup.py (path:/tmp/pip-K6B_n4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:03:48 INFO - Running setup.py (path:/tmp/pip-05WWL6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:03:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:03:48 INFO - Running setup.py (path:/tmp/pip-Ceb2O9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:03:48 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 14:03:48 INFO - Running setup.py install for manifestparser 14:03:48 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 14:03:48 INFO - Running setup.py install for mozcrash 14:03:48 INFO - Running setup.py install for mozdebug 14:03:49 INFO - Running setup.py install for mozdevice 14:03:49 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Installing dm script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Running setup.py install for mozfile 14:03:49 INFO - Running setup.py install for mozhttpd 14:03:49 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Running setup.py install for mozinfo 14:03:49 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Running setup.py install for mozInstall 14:03:49 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Running setup.py install for mozleak 14:03:49 INFO - Running setup.py install for mozlog 14:03:49 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Running setup.py install for moznetwork 14:03:49 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 14:03:49 INFO - Running setup.py install for mozprocess 14:03:49 INFO - Running setup.py install for mozprofile 14:03:50 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 14:03:50 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 14:03:50 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 14:03:50 INFO - Running setup.py install for mozrunner 14:03:50 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 14:03:50 INFO - Running setup.py install for mozscreenshot 14:03:50 INFO - Running setup.py install for moztest 14:03:50 INFO - Running setup.py install for mozversion 14:03:50 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 14:03:50 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 14:03:50 INFO - Cleaning up... 14:03:50 INFO - Return code: 0 14:03:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:03:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:50 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 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:50 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 14:03:50 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 14:03:50 INFO - Using env: {'DISPLAY': ':0', 14:03:50 INFO - 'HOME': '/home/cltbld', 14:03:50 INFO - 'LANG': 'en_US.UTF-8', 14:03:50 INFO - 'LANGUAGE': 'en_US:en', 14:03:50 INFO - 'LOGNAME': 'cltbld', 14:03:50 INFO - 'MAIL': '/var/mail/cltbld', 14:03:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:50 INFO - 'MOZ_NO_REMOTE': '1', 14:03:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:50 INFO - 'NO_EM_RESTART': '1', 14:03:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:50 INFO - 'PWD': '/builds/slave/test', 14:03:50 INFO - 'SHELL': '/bin/bash', 14:03:50 INFO - 'SHLVL': '1', 14:03:50 INFO - 'TERM': 'linux', 14:03:50 INFO - 'TMOUT': '86400', 14:03:50 INFO - 'USER': 'cltbld', 14:03:50 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:50 INFO - '_': '/tools/buildbot/bin/python'} 14:03:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:03:50 INFO - Running setup.py (path:/tmp/pip-do30Pc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:03:50 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)) 14:03:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:03:50 INFO - Running setup.py (path:/tmp/pip-8IaqNU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:03:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:03:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:03:50 INFO - Running setup.py (path:/tmp/pip-1d9Qwe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:03:50 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)) 14:03:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:03:50 INFO - Running setup.py (path:/tmp/pip-MctVVh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:03:51 INFO - Running setup.py (path:/tmp/pip-GM0G8i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:03:51 INFO - Running setup.py (path:/tmp/pip-Taa0gj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:03:51 INFO - Running setup.py (path:/tmp/pip-6aHRXA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:03:51 INFO - Running setup.py (path:/tmp/pip-cGC9pO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:03:51 INFO - Running setup.py (path:/tmp/pip-UnFGNh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:03:51 INFO - Running setup.py (path:/tmp/pip-2yaItR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:03:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:03:51 INFO - Running setup.py (path:/tmp/pip-kbXzjK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:03:51 INFO - Running setup.py (path:/tmp/pip-67vcGi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:03:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:03:51 INFO - Running setup.py (path:/tmp/pip-P5c3hZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:03:51 INFO - Running setup.py (path:/tmp/pip-Zu_ddM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:03:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:03:51 INFO - Running setup.py (path:/tmp/pip-k775Sx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:03:51 INFO - Running setup.py (path:/tmp/pip-TJjsX2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:03:51 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)) 14:03:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:03:51 INFO - Running setup.py (path:/tmp/pip-4IbAnL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:03:51 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)) 14:03:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:03:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:03:51 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)) 14:03:51 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)) 14:03:51 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)) 14:03:52 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 14:03:52 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 14:03:52 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 14:03:52 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 14:03:52 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 14:03:52 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 14:03:52 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 14:03:53 INFO - Downloading blessings-1.6.tar.gz 14:03:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 14:03:53 INFO - Installing collected packages: blessings 14:03:53 INFO - Running setup.py install for blessings 14:03:54 INFO - Successfully installed blessings 14:03:54 INFO - Cleaning up... 14:03:54 INFO - Return code: 0 14:03:54 INFO - Done creating virtualenv /builds/slave/test/build/venv. 14:03:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:03:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:03:54 INFO - Reading from file tmpfile_stdout 14:03:54 INFO - Current package versions: 14:03:54 INFO - argparse == 1.2.1 14:03:54 INFO - blessings == 1.6 14:03:54 INFO - blobuploader == 1.2.4 14:03:54 INFO - docopt == 0.6.1 14:03:54 INFO - functools32 == 3.2.3-2 14:03:54 INFO - jsonschema == 2.5.1 14:03:54 INFO - manifestparser == 1.1 14:03:54 INFO - mozInstall == 1.12 14:03:54 INFO - mozcrash == 0.17 14:03:54 INFO - mozdebug == 0.1 14:03:54 INFO - mozdevice == 0.48 14:03:54 INFO - mozfile == 1.2 14:03:54 INFO - mozhttpd == 0.7 14:03:54 INFO - mozinfo == 0.9 14:03:54 INFO - mozleak == 0.1 14:03:54 INFO - mozlog == 3.2 14:03:54 INFO - moznetwork == 0.27 14:03:54 INFO - mozprocess == 0.22 14:03:54 INFO - mozprofile == 0.28 14:03:54 INFO - mozrunner == 6.11 14:03:54 INFO - mozscreenshot == 0.1 14:03:54 INFO - mozsystemmonitor == 0.3 14:03:54 INFO - moztest == 0.7 14:03:54 INFO - mozversion == 1.4 14:03:54 INFO - psutil == 3.1.1 14:03:54 INFO - requests == 1.2.3 14:03:54 INFO - wsgiref == 0.1.2 14:03:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:03:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:54 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 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:54 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 14:03:54 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 14:03:54 INFO - Using env: {'DISPLAY': ':0', 14:03:54 INFO - 'HOME': '/home/cltbld', 14:03:54 INFO - 'LANG': 'en_US.UTF-8', 14:03:54 INFO - 'LANGUAGE': 'en_US:en', 14:03:54 INFO - 'LOGNAME': 'cltbld', 14:03:54 INFO - 'MAIL': '/var/mail/cltbld', 14:03:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:54 INFO - 'MOZ_NO_REMOTE': '1', 14:03:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:54 INFO - 'NO_EM_RESTART': '1', 14:03:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:54 INFO - 'PWD': '/builds/slave/test', 14:03:54 INFO - 'SHELL': '/bin/bash', 14:03:54 INFO - 'SHLVL': '1', 14:03:54 INFO - 'TERM': 'linux', 14:03:54 INFO - 'TMOUT': '86400', 14:03:54 INFO - 'USER': 'cltbld', 14:03:54 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:54 INFO - '_': '/tools/buildbot/bin/python'} 14:03:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 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)) 14:03:54 INFO - Cleaning up... 14:03:54 INFO - Return code: 0 14:03:54 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 14:03:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:03:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:03:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:03:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:03:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xbfe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, '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': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', '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 14:03:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 14:03:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 14:03:54 INFO - Using env: {'DISPLAY': ':0', 14:03:54 INFO - 'HOME': '/home/cltbld', 14:03:54 INFO - 'LANG': 'en_US.UTF-8', 14:03:54 INFO - 'LANGUAGE': 'en_US:en', 14:03:54 INFO - 'LOGNAME': 'cltbld', 14:03:54 INFO - 'MAIL': '/var/mail/cltbld', 14:03:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:03:54 INFO - 'MOZ_NO_REMOTE': '1', 14:03:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:03:54 INFO - 'NO_EM_RESTART': '1', 14:03:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:03:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:03:54 INFO - 'PWD': '/builds/slave/test', 14:03:54 INFO - 'SHELL': '/bin/bash', 14:03:54 INFO - 'SHLVL': '1', 14:03:54 INFO - 'TERM': 'linux', 14:03:54 INFO - 'TMOUT': '86400', 14:03:54 INFO - 'USER': 'cltbld', 14:03:54 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:03:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:03:54 INFO - '_': '/tools/buildbot/bin/python'} 14:03:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:03:54 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 14:03:54 INFO - Cleaning up... 14:03:54 INFO - Return code: 0 14:03:54 INFO - Running post-action listener: _resource_record_post_action 14:03:54 INFO - Running post-action listener: _start_resource_monitoring 14:03:54 INFO - Starting resource monitoring. 14:03:54 INFO - ##### 14:03:54 INFO - ##### Finished create-virtualenv step (success) 14:03:54 INFO - ##### 14:03:54 INFO - ##### 14:03:54 INFO - ##### Running install step. 14:03:54 INFO - ##### 14:03:54 INFO - Running pre-action listener: _resource_record_pre_action 14:03:54 INFO - Running main action method: install 14:03:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:03:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:03:55 INFO - Reading from file tmpfile_stdout 14:03:55 INFO - Detecting whether we're running mozinstall >=1.0... 14:03:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 14:03:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 14:03:55 INFO - Reading from file tmpfile_stdout 14:03:55 INFO - Output received: 14:03:55 INFO - Usage: mozinstall [options] installer 14:03:55 INFO - Options: 14:03:55 INFO - -h, --help show this help message and exit 14:03:55 INFO - -d DEST, --destination=DEST 14:03:55 INFO - Directory to install application into. [default: 14:03:55 INFO - "/builds/slave/test"] 14:03:55 INFO - --app=APP Application being installed. [default: firefox] 14:03:55 INFO - mkdir: /builds/slave/test/build/application 14:03:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 14:03:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 14:04:12 INFO - Reading from file tmpfile_stdout 14:04:12 INFO - Output received: 14:04:12 INFO - /builds/slave/test/build/application/firefox/firefox 14:04:12 INFO - Running post-action listener: _resource_record_post_action 14:04:12 INFO - ##### 14:04:12 INFO - ##### Finished install step (success) 14:04:12 INFO - ##### 14:04:12 INFO - ##### 14:04:12 INFO - ##### Running run-tests step. 14:04:12 INFO - ##### 14:04:12 INFO - Running pre-action listener: _resource_record_pre_action 14:04:12 INFO - Running main action method: run_tests 14:04:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 14:04:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 14:04:12 INFO - Python 2.7.3 14:04:12 INFO - Return code: 0 14:04:12 INFO - grabbing minidump binary from tooltool 14:04:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:04:12 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 0xebd3b0>, '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 0xebe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebe740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 14:04:12 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 14:04:12 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 14:04:12 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 14:04:12 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 14:04:12 INFO - Return code: 0 14:04:12 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 14:04:12 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 14:04:12 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 14:04:12 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 14:04:12 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 14:04:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 14:04:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-011 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 14:04:12 INFO - Using env: {'DISPLAY': ':0', 14:04:12 INFO - 'HOME': '/home/cltbld', 14:04:12 INFO - 'LANG': 'en_US.UTF-8', 14:04:12 INFO - 'LANGUAGE': 'en_US:en', 14:04:12 INFO - 'LOGNAME': 'cltbld', 14:04:12 INFO - 'MAIL': '/var/mail/cltbld', 14:04:12 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 14:04:12 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 14:04:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:04:12 INFO - 'MOZ_NO_REMOTE': '1', 14:04:12 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 14:04:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:04:12 INFO - 'NO_EM_RESTART': '1', 14:04:12 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:04:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:04:12 INFO - 'PWD': '/builds/slave/test', 14:04:12 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 14:04:12 INFO - 'SHELL': '/bin/bash', 14:04:12 INFO - 'SHLVL': '1', 14:04:12 INFO - 'TERM': 'linux', 14:04:12 INFO - 'TMOUT': '86400', 14:04:12 INFO - 'USER': 'cltbld', 14:04:12 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676', 14:04:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:04:12 INFO - '_': '/tools/buildbot/bin/python'} 14:04:12 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 14:04:12 INFO - mozversion application_buildid: 20160701113033 14:04:12 INFO - mozversion application_changeset: 7d431089a2d2c584bea146b354b06026c80291a1 14:04:12 INFO - mozversion application_display_name: Nightly 14:04:12 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 14:04:12 INFO - mozversion application_name: Firefox 14:04:12 INFO - mozversion application_remotingname: firefox 14:04:12 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 14:04:12 INFO - mozversion application_vendor: Mozilla 14:04:12 INFO - mozversion application_version: 50.0a1 14:04:12 INFO - mozversion platform_buildid: 20160701113033 14:04:12 INFO - mozversion platform_changeset: 7d431089a2d2c584bea146b354b06026c80291a1 14:04:12 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 14:04:12 INFO - mozversion platform_version: 50.0a1 14:04:12 INFO - using testdate: 1467407052 14:04:12 INFO - actual date: 1467407052 14:04:12 INFO - starting webserver on 'localhost:45790' 14:04:12 INFO - SUITE-START | Running 2 tests 14:04:12 INFO - TEST-START | dromaeo_css 14:04:12 INFO - operating with platform_type : linux_ 14:04:12 INFO - Initialising browser for dromaeo_css test... 14:04:12 INFO - TEST-INFO | started process 17976 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpxAUud7/profile http://localhost:45790/getInfo.html) 14:04:17 INFO - PROCESS | 17976 | __metrics Screen width/height:1600/1200 14:04:17 INFO - PROCESS | 17976 | colorDepth:24 14:04:17 INFO - PROCESS | 17976 | Browser inner width/height: 1024/697 14:04:17 INFO - PROCESS | 17976 | __metrics 14:04:19 INFO - PROCESS | 17976 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:04:19 INFO - PROCESS | 17976 | console.error: PushService: 14:04:19 INFO - PROCESS | 17976 | stateChangeProcessEnqueue: Error transitioning state 14:04:19 INFO - PROCESS | 17976 | UnknownError 14:04:20 INFO - TEST-INFO | 17976: exit 0 14:04:20 INFO - Browser initialized. 14:04:20 INFO - Running cycle 1/1 for dromaeo_css test... 14:04:20 INFO - TEST-INFO | started process 18058 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpxAUud7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:04:31 INFO - PROCESS | 18058 | RSS: Main: 157810688 14:04:31 INFO - PROCESS | 18058 | 14:05:22 INFO - PROCESS | 18058 | 1467407122731 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] 14:07:32 INFO - PROCESS | 18058 | Cycle 1(1): loaded http://localhost:45790/tests/dromaeo/cssquery-dojo.html (next: http://localhost:45790/tests/dromaeo/cssquery-ext.html) 14:07:33 INFO - PROCESS | 18058 | RSS: Main: 255135744 14:07:33 INFO - PROCESS | 18058 | 14:10:35 INFO - PROCESS | 18058 | Cycle 1(1): loaded http://localhost:45790/tests/dromaeo/cssquery-ext.html (next: http://localhost:45790/tests/dromaeo/cssquery-jquery.html) 14:10:36 INFO - PROCESS | 18058 | RSS: Main: 248143872 14:10:36 INFO - PROCESS | 18058 | 14:13:37 INFO - PROCESS | 18058 | Cycle 1(1): loaded http://localhost:45790/tests/dromaeo/cssquery-jquery.html (next: http://localhost:45790/tests/dromaeo/cssquery-mootools.html) 14:13:38 INFO - PROCESS | 18058 | RSS: Main: 251383808 14:13:38 INFO - PROCESS | 18058 | 14:16:40 INFO - PROCESS | 18058 | Cycle 1(1): loaded http://localhost:45790/tests/dromaeo/cssquery-mootools.html (next: http://localhost:45790/tests/dromaeo/cssquery-prototype.html) 14:16:41 INFO - PROCESS | 18058 | RSS: Main: 245850112 14:16:41 INFO - PROCESS | 18058 | 14:19:43 INFO - PROCESS | 18058 | Cycle 1(1): loaded http://localhost:45790/tests/dromaeo/cssquery-prototype.html (next: http://localhost:45790/tests/dromaeo/cssquery-yui.html) 14:19:44 INFO - PROCESS | 18058 | RSS: Main: 224772096 14:19:44 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | Cycle 1(1): loaded http://localhost:45790/tests/dromaeo/cssquery-yui.html (next: http://localhost:45790/tests/dromaeo/cssquery-dojo.html) 14:22:47 INFO - PROCESS | 18058 | RSS: Main: 291553280 14:22:47 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | __start_tp_report 14:22:47 INFO - PROCESS | 18058 | _x_x_mozilla_page_load 14:22:47 INFO - PROCESS | 18058 | _x_x_mozilla_page_load_details 14:22:47 INFO - PROCESS | 18058 | |i|pagename|runs| 14:22:47 INFO - PROCESS | 18058 | |0;dojo.html;3118.7816852820306;3123.7032481914225;3140.13646247282;3163.9683603163962;3188;5243.711595862226;5301.814436494724;5410.675359478434;5514.834554963348;5526.364468086176;5397.649152805075;5405.108157154074;5415.756290966906;5446.210299506569;5512.5589952803775;4836.226203807391;4875.073735990169;4919.704817710931;4936.160852655039;4996.7001979881325;4904.803807847682;4938.629602779788;4955.851324460254;4966.726830024347;4973.452920178777;4821.204501257288;4855.975720121412;4887.169181239163;4910.901781964377;4984.0281145176705;4810.086083644132;4817.686850354716;4819.95180048202;4904.9699563091435;4982.825601103944;4831.806727730886;4884.218525035977;4884.975575122102;4884.998575292057;4932.556069953722;5285.68285902847;5329.573634109301;5427.43011983744;5480.671159730429;5490.066688662937;5743.913841292384;5830.300363956352;5856.531477481792;5859.8535036624;5866.061430171152;5841.386654401269;5854.326752423483;5891.705414729289;5903.409659034105;5910.763569457216;5292.655977361498;5372.811951581754;5422;5502.449755024506;5509.889802203974;6016.548758843104;6017.187679663277;6020.518358531307;6023.879522409527;6028.819135425944;5717.771289148471;5722.856928576819;5757.481826635623;5772.826815195551;5774.307083150049;5584.329880414295;5631.239782629293;5670.347909990322;5684.317881854204;5858.443447872445;5711.257536520226;5722.37053924068;5728.627639203439;5730.312362516442;5731.083026715705;5690.9146362804595;5696.11710184922;5731.426857314319;5736.110902810071;5743.6266642668925;4319.67602429819;4362.563743625676;4365.039691267916;4412.84555040572;4416.227160246944;3949.6642785363565;3964.702647301406;3975.840966361371;3983.701222408331;3983.9601603983588;5231.267622532849;5402.432744561843;5455.1271796512365;5472.069748142825;5519.69641669712;5836.88326233473;5839.708014599338;5845.123231515222;5847.590668653153;5882.294124705063;5433.8369848904595;5444.074507333763;5479.780808767684;5483.424240454775;5501.477359650827;4850.95149048512;4885;4904.5340692634145;4912.70523768575;5027.044861476381;5882.617629854131;5888.146218798251;5893.616914900518;5897.469227769436;5897.469227769521;5652.869426114711;5699.658020518699;5706.686132262766;5708.286464191976;5708.800191993427;5780.104083867007;5806.65160090396;5858.765649373977;5883.852903677271;5920.467157955804;5629.380768115586;5630.211770352236;5631.239782629293;5634.408387119293;5640.153976903333;5621.044422448112;5728.742206600629;5730.054541000688;5741.712914354182;5741.971290143522;5589.021921163861;5608.10270356741;5665.461781130786;5725.312962444534;5733.455321744427;5664.207011018543;5694.743736531949;5700.942990570041;5707.372189059283;5713.457221563945;5411.107167317348;5550.27846379968;5594.580406469449;5610.747516361692;5616.7191640416995;5701.657900525982;5784.045632470596;5789.305283366023;5792.21805056312;5845.41545845429;5637.605367624227;5640.661560306231;5644.971775141263;5647.830565083054;5656.095024796013 14:22:47 INFO - PROCESS | 18058 | |1;ext.html;582.5165112956247;618.6164577961663;620.4509009526573;623.2427600465435;634.984125396865;34573.827130864345;37174.25651486969;37352;45079.32381014279;46654.06691866161;47478;47870.28194577084;47926.76036619812;48046.279305810356;48112.75943620277;8943.373963822518;9076.183143517082;9086.136817002374;9098.090190980914;9101.817963640757;8839.77900552488;8918.241949434307;8920.03759172981;8921.866172007425;8936.106389361077;8956;8977.551122443885;8986.056464071276;9024.954875225614;9025.232855207316;8926.330525210635;8959.552022398919;8974.371793974424;8976.685815996441;8985.820283594358;8886.200241978253;8915.331350148765;8953.820923581558;8956.193942545202;8959.328050396247;43997.900052498626;44354.77822610866;44390.77804610956;44400;44421.77789111066;3521.6126226115107;4010.4786377770993;4245.957540424618;4261.403403523509;4344.478662560481;33671.326573468396;34232;34603.4809477858;34657.48013779795;35143.4728479073;4331.935020974688;4395.648348132142;4429.247028005247;4429.291313389875;4436.245838207513;344638;345624.9999999975;345774;347009;347813;60824;60886.695566521885;60941.69529152326;61226.387736122066;61288;37899;38702.80648596739;64340;64354.356456434834;64540.354596454374;16794.24425900813;16918.492445226664;16924.915375423043;16938.153092345332;16938.576535586464;12619.621411357673;12704.047196460118;12714.491420343267;12717.936410318074;12724.04569657261;20099;20372.388828335173;20377.49056273605;20569.897150514153;20630.690539641917;7169.641517924083;7314.597697126709;7481.35410209753;7505.6997720090585;7597.164311925684;1017.867677201959;1066.2429674930886;1110.9945499323126;1165.6778182180885;1167.1363191238593;33958;34409.483857742154;34627.82686086604;34690.65309346925;34818.129546761535;937.8968313485511;1104.2380757277454;1116.1349953785718;1147.2485521982946;1207.979257527388;17254.741178882075;17968.101594920463;17969.281228750704;17984.640307194044;18119.45641630753;531506;532727;535823;536564;537404;60115.39884601098;61509.38490615126;61518.69240653768;61841.07238391338;61886.38113618896;1239.7210627608715;1328.6346254780012;1361.4213959067356;1367.8358596968228;1391.0679844504207;33604.49593256152;35423.46864797082;35682.64317356793;36035.819820900724;36085.09787255339;46721.29918051164;46985.76507117443;47137;47227.52772472231;47238.291425627955;395845;404676;405363.7586308682;405886;406984;26284;26797.330066748487;26847.328816778954;28696.85651571729;29728.554071688508;49172.75413623052;50471.74764126156;50756.74621626868;50778.238326425875;51852.222216667535;43040.35439468473;43372.783136084116;43536;44604.553954461335;44965;42414.57585424106;42726;42766.358504621836;43028.78485607552;43420.56579434165;43429.78285108554;44317;44662.77668611636;45691.31463028124;47373;35745.64254357527;38744.6125538741;38788.41817372685;39240.626578069634;40171.39742903917;29554.690272564072;29629.25926851846;29978.25054373658;29983.062095743524;30233 14:22:47 INFO - PROCESS | 18058 | |2;jquery.html;402.23775944585014;403.83846461415413;406.9918601627969;411.66038018634623;422.26736611978214;14369.92815035926;18703.158357873894;20653.483662908417;20657.586848263025;20733.341332693388;18762.62474750504;19685.21259149632;19832.70250946237;20558.177672893067;20883.895580522076;5462.289902312704;5583.6928968906695;5589.552835773149;5592.412796656333;5614.522765564911;4107.322291821846;5472.781088756445;5508.20131080993;5515.779368825262;5519.31008623922;5851.297844258674;6159.045347971071;6165.969170154165;6248.812535623939;6251.031090181029;6196.75212991482;6200.16297799798;6234.5324100692405;6707.564008339491;6712.630805305706;6000.369961154103;6006.309274433453;6007.15899774032;6029.397060293935;6034.788782392639;24844.50310993788;25539;25995;26126.6081008785;26159.346016349555;2189.9562008759895;2374.41826752445;2413.7466911929714;2657.734226577346;2734.179746076169;10569.10162636177;10607.469626518721;10962.616308429246;11322.773544529064;11533.884661153365;1963.68581027035;1978.0406502846108;2013.8590298679098;2057.722207501983;2072.616565935307;87098.56450717706;89860;91981.54009229978;92226.53886730524;93809.53095234481;11851.88148118525;11861.5848445304;11914.404279785977;11919.88080119205;11966.64100076999;16751.329946802234;16915.746263806053;16928.153592320334;16959.830401695825;16972.23624936881;7692.46152769312;7695.846083078419;7816.296533312029;7859.410544209207;7876.133625301212;7059.752908648173;7104.92895071053;7124.216336203013;7196.316349946746;7201.279872012861;5161.974190129025;5167.509086636764;5215.895682086337;5219.608529360313;5288.788448462018;2054.41449186984;2093.3510611710417;2102.611016961867;2109.588630217093;2117.90469428873;978.9070038346346;1034.6016783538391;1038.3717850700368;1043.4574021508772;1050.4642632257603;19567.902160489106;20774.272900448414;20941.685874711893;20943.476413089793;21279.255226067322;949.2263804998904;976.4483067067226;980.7499087732582;991.7768502086973;1039.4542864995788;11359.943200284111;11601.535938562532;11736.765264694659;11847.170698051053;11870.465829037714;465761;467515;467970;468823;477077;54195.72902135543;57458;59684.403155967884;86972.56513717391;98728.50635746775;926.5321012888448;930.1721467893581;941.8963913969458;941.9764505887271;944.1596978688972;19062.33281835129;19134.23463061462;19385.51536211606;19468.415947521597;19606.90196549065;44268.55731442644;44294.77852610716;45823.541764581925;46860.53139468698;47666;55135.72432137813;55422.44577554173;56928.71535642461;65167.34832651613;66400;9415.95292023563;9423.151916327564;9569.712908612753;9626.181774549243;9856.852147217654;13570.38933248026;13789.24159171215;13939;14356.85643143597;14816.185109818633;11893.702657433634;12041.397930103285;12089.75820483603;12397.75204495923;12688.6827829305;12100.334481603597;12333.93833030829;12400.81398779001;12507.061970352443;12731.745365092462;12879.098463107492;12937.28844913501;13020.153690010118;13283.80074298867;13349.332533373099;9299.070092990647;9426.387284826464;9464;9533.809323813346;9800.313978021755;11452.828207576726;12815.231086134861;12851.614451566467;12975.416106275052;13074.346282686018 14:22:47 INFO - PROCESS | 18058 | |3;mootools.html;1474.4839306242814;1505.6160679026846;1654.4292219184385;1769.3188122572806;1804.2963244334703;8413.116622754607;8891.777705557348;9002.054784247657;9014.504202268872;9015.278777697786;7859.449838511307;8051.597420128999;8260;8275.337972962163;8781.736547903558;2393.3059412770317;2419.8790060496995;2421.878906054699;2422.2491027781357;2427.9271621851285;2417.7703118203744;2422.648715936188;2444.743301953296;2453.901843926241;2454.214651311581;2114.06980928391;2364.196173301077;2432.4405386761055;2443.4746529496156;2464.581021226396;2438.198779407225;2446.315031791092;2474.5298393305216;2477.343503971449;2493.3891196656937;2432.2460037388464;2449.9755002449924;2461.54461424637;2461.778439940414;2463.322586288767;8802.251808596277;8936.776580585472;8940.955295223548;8942.105789421006;8951.865722014176;5309.097453432925;5442.156465747816;5447.291852059207;5450.945490545084;5451.64564303319;3308.4044871923043;3365.562476878015;3440.3807314683345;3441.1225137590004;3509.4209455440077;1067.1089640150483;1085.3270971997333;1093.1309608860975;1100.3068067117665;1109.6504601050642;12301.200421972542;12303.630891073282;12318.137730358878;12332.568360107352;12399.938000309941;4883.536064073907;4901.264810278415;4918.606511479073;5018.623603229772;5026.421961474404;10358.689239322832;10373.896261037293;10399.948000260101;10403.375797452178;10411.219158563137;5475.589330800126;5499.972500137474;5507.504324610804;5510.338759348904;5513.255710479034;4979.178435558165;5064.063148317573;5073.34046573943;5073.568746656501;5089.847304580869;4112.91774164515;4124.319487284624;4137.686965155542;4153.605407486284;4169.958300417018;1256.1772039314264;1322.9867701323055;1344.227069435059;1358.517726207202;1359.136948038003;803.9829615536352;838.0906716212977;869.4479005831342;916.834969705446;959.4339339789558;5965.403459654;6052.213212282375;6168.414000669929;6205.503559715212;6266.592671476339;976.9023097690316;982.9678837221032;990.7919336939324;1023.4626820919077;1099.378850949211;3953.723239373216;4090.1206240658403;4122.051928056504;4144.70987030905;4271.124419493996;10712.250142489951;10883.292585981886;10943.726406839893;11052.889471105185;11062.170337224741;9666.323357365058;10299.845502317472;10936.617218397318;10940.890591093987;10956.506957186946;8021.5187088774865;8243.340532757366;8266.710665126811;8268.462549934355;8270.917290827014;5838;5864.501517371071;6005.249343832021;6011.879762404815;6135.447809697149;9601.231901447727;10241.743956400851;10247.436390998566;10279;10290.176785857264;10027.699169024942;10296.17630589536;10376.896231037594;10404.739881503023;10416.739581510219;7718.15100338951;7748.612569371621;7850.646720897687;7872.37021038327;7905.841883162189;8489.40574159803;8535.189157030072;8610.13898610134;8610.354223433142;8611.6985905493;7714.498557593738;7862.213778622092;7884.4086693497065;7994.760157195294;8007.639656215601;7720.53676779395;7727.150013498623;7764.184760600056;7889.84220315579;7918.366530677416;6602.240742314695;6652.068710380648;6677;6678.265390807104;6687.465002799861;5090.770915308746;5157.896842063213;5238.5023422774775;5274.8945021100135;5334.173203153362;5209.76172022494;5210.062188806051;5215.426303106579;5283.788648454019;5354.3842458117815 14:22:47 INFO - PROCESS | 18058 | |4;prototype.html;334.18458960137264;343.7421933549838;352.89413176047185;353.33925559204295;357.9856805727771;5153.1754919212835;5229.450907654698;5258.710770907599;5306.575473962079;5318.643745844814;5237.3453318335205;5310.256564081022;5316.282301889244;5319.627626066177;5342.866428339294;4204.474440694913;4211.5367309595995;4229.7885105744745;4236.491621005468;4236.639885609711;3955.3275943089743;4009.83960641574;4167.3332266837315;4203.957960420387;4221.2190744712325;4149.792510374485;4160.916781664365;4173.791310434482;4180.205760905418;4182.435371224891;4148.979255103705;4154.459920210368;4156.251874662559;4163.791810409467;4173.332266837322;3675.815562246487;3688.5020522229424;3744.3821769408014;3746.1571146492092;3753.1367785409507;5066.328111723123;5072.137736584789;5161.4322424533275;5161.4322424533275;5164.173732202829;4746.359241502388;4747.620190384761;4753.619710423192;4764.6426518011285;4769.928451073237;5351.304330437058;5462.2079798429;5482.698451585201;5575.944240557583;5576;4132.276851550967;4170.332746760504;4170.812313445902;4177.164567086565;4182.226288136704;5711.942880571182;5759.654420734728;5767.36558978512;5769.711514424262;5769.711514424304;4184.163167366539;4267.445232119867;4293.97853010733;4298.613124818781;4315.28797748368;4329.718568293051;4344;4347.891302717458;4354.238008348526;4362.629176520031;4850.80596776125;4857.757112144379;4863.106451661256;4866.7566621668775;4882.633802464829;5342.465753424626;5599.356074051455;5604.971975140098;5646.2377579027125;5653.462921022497;1418.1987177244823;1465.8314293856129;1478.1279045363287;1495.7158139953592;1501.9111144420208;992.9205663546899;1020.9897901021043;1025.410389026298;1031.298716872519;1034.1623285139062;5300.602454815904;5303.575713942875;5318.73406329682;5328.573714102862;5333.519983201453;5579.69311687861;5598;5620.494155526022;5638.746256418471;5648.15277708347;5130.563902068366;5229.921551176735;5247.370315562157;5347.304850369427;5371.543418809367;2619.7118316985116;2647.9275893262875;2653.283613424365;2679.5846643770246;2681.2358477833723;5143.742812859342;5165.405978312542;5166.55336505779;5186.273921650972;5209.505097015777;4760.690555113906;5084.41529224144;5102.719350435687;5108.438071812097;5117.923231151536;5120.411152717411;5123.66696164763;5132.692038477629;5172.965406918632;5182.326297581366;4899.853004409873;4972.726500042532;4978.775955081957;4999.450060493416;5002.274670172877;4709.740964246999;4888.706677599355;4901.779419926183;4916.139675556692;5002.799888004439;5138.486151384832;5140.151874940593;5141.408737995179;5171.3277273954145;5188.55897248723;3873.806309684448;3882.0007696036;3901.4147877818555;3902.8829135125993;3915.8433662653174;5017.448080711046;5273.578113750814;5523.978064058162;5578.56917995438;5734.22587950638;5549.500544950974;5560.7219639018695;5576.247206627054;5583.664980101207;5595.552355811444;5494.2857428534035;5504;5537.36320323168;5558.166275058774;5578.888422231452;5253.579713622978;5503.862403439786;5506.559475242051;5529.502344788988;5533.6126471148245;5587.329520457572;5604.2154098425435;5614.41048689898;5617.354004289396;5640.661560306395;5235.921461178162;5515.558755299647;5516.862078448071;5524;5526.917096243479 14:22:47 INFO - PROCESS | 18058 | |5;yui.html;743.9070116235471;750.8122969257687;751.9699212031518;775.6160700453277;781.8319061401797;15865.920670396647;16803.747943780836;16915.06967116808;16975;16998;14943.775843362359;15031.699366012674;15048;15072.095674259552;15152.242387880617;700.8318003679119;841.2302742990157;849.7365816596844;854.1629203380691;855.5593869157389;838.2204549768712;846.3948276981956;846.3990566697652;846.7925358287229;847.0174597466939;898.371140201858;898.8112496375769;900.0369604523163;900.1943260781596;900.3922352412128;892.7455675132557;896.0412358776113;896.1486587741639;896.4262871762045;896.6906417286026;651.205529254309;651.475562172451;651.540663832002;651.8631087471637;651.8663673946829;16588.25352859124;16593.336266549322;16606.169691515377;16623.335066597323;16629.50111496657;14623.122612643276;15009.283990825224;15037.323320450607;15287.694246115016;15583.142927139002;13396.598102056954;13523.864761352359;14163.433462661482;14188.716225675429;14760.114393136339;4703.741294228816;4717.457492388385;4757.0723708876785;4792.9760351198365;4834.564889159958;77429.61285193538;77561.61219193925;78857.81713274306;79335.6033219836;79635.6018219911;12437.75124497505;12505.499780008699;12628.242305461701;12962.740745185043;13235.27206003679;23076.307710768702;23079.538409232056;23218.76781232166;23225.651615225786;23242.65136022961;8871.334649901155;9089.046879137333;9093.318001149808;9177.128172823572;9379.48412837287;4818.855434336975;4892.363992680928;4892.755362231946;4961.131801934647;5160.045391602565;3702.407614781622;3812.942805857914;3814.3134235837815;3818.3508803503473;3820.980895095562;649.7985624456434;720.4020662849927;766.6856588798565;772.0658003815334;778.8831675248758;632.8354627796714;726.2156870579761;752.8644843928146;770.4799260499141;779.7115067424976;10263.272669600765;10311.742206444898;10534.047528631067;10929.180311476672;10997.945010275058;624.9562530622812;748.8202831320444;769.3114662377141;774.6668932359026;782.1904329019437;4966.975165124151;5147.219193020735;5165.380154381423;5224.320838290998;5237.528622424;128559.35720321526;131708;132252;132531;134869;114382;114976.44556639879;115698.42150789192;116725;119470;65392;103625.48187259016;103943.48028259962;104405;105593.47203264089;9767.169790567881;9770.511474426392;9856.112949834549;9923.305368624417;10027.197824174194;47040;47135.764321178176;59079.70460147672;60987.39012609817;61226.387736122066;54191.72904135454;78100;79183.20816791759;79938.60030700042;80687;13761.243131627856;13885.652858678613;14159.43362265539;14190.787138192729;14272.71454570882;15723.21383930776;16183.514494564712;16267.918660406622;16371;16809.571186449288;14659.780103298246;14699.779503307245;15146.394144234107;15661.84338156604;15668.529944101696;14051.156930584199;14794.334254958769;14938.178400187659;15064.548063558112;15552.30014649321;14001.579952601438;14523.658178062105;14676.55970320892;14852.331645076214;15121.848781512044;12047.397630118634;12054.276743395425;12219.26684398939;12235.449404776984;12609.243445393306;11803.23278986863;12374;12521.31132787669;12530.561430349893;12734 14:22:47 INFO - PROCESS | 18058 | __end_tp_report 14:22:47 INFO - PROCESS | 18058 | __start_cc_report 14:22:47 INFO - PROCESS | 18058 | _x_x_mozilla_cycle_collect,767 14:22:47 INFO - PROCESS | 18058 | __end_cc_report 14:22:47 INFO - PROCESS | 18058 | __startTimestamp1467408167659__endTimestamp 14:22:47 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | ------- Summary: start ------- 14:22:47 INFO - PROCESS | 18058 | Number of tests: 6 14:22:47 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | [#0] dojo.html Cycles:165 Average:5365.02 Median:5616.72 stddev:609.70 (10.9%) stddev-sans-first:585.56 14:22:47 INFO - PROCESS | 18058 | Values: 3118.8 3123.7 3140.1 3164.0 3188.0 5243.7 5301.8 5410.7 5514.8 5526.4 5397.6 5405.1 5415.8 5446.2 5512.6 4836.2 4875.1 4919.7 4936.2 4996.7 4904.8 4938.6 4955.9 4966.7 4973.5 4821.2 4856.0 4887.2 4910.9 4984.0 4810.1 4817.7 4820.0 4905.0 4982.8 4831.8 4884.2 4885.0 4885.0 4932.6 5285.7 5329.6 5427.4 5480.7 5490.1 5743.9 5830.3 5856.5 5859.9 5866.1 5841.4 5854.3 5891.7 5903.4 5910.8 5292.7 5372.8 5422.0 5502.4 5509.9 6016.5 6017.2 6020.5 6023.9 6028.8 5717.8 5722.9 5757.5 5772.8 5774.3 5584.3 5631.2 5670.3 5684.3 5858.4 5711.3 5722.4 5728.6 5730.3 5731.1 5690.9 5696.1 5731.4 5736.1 5743.6 4319.7 4362.6 4365.0 4412.8 4416.2 3949.7 3964.7 3975.8 3983.7 3984.0 5231.3 5402.4 5455.1 5472.1 5519.7 5836.9 5839.7 5845.1 5847.6 5882.3 5433.8 5444.1 5479.8 5483.4 5501.5 4851.0 4885.0 4904.5 4912.7 5027.0 5882.6 5888.1 5893.6 5897.5 5897.5 5652.9 5699.7 5706.7 5708.3 5708.8 5780.1 5806.7 5858.8 5883.9 5920.5 5629.4 5630.2 5631.2 5634.4 5640.2 5621.0 5728.7 5730.1 5741.7 5742.0 5589.0 5608.1 5665.5 5725.3 5733.5 5664.2 5694.7 5700.9 5707.4 5713.5 5411.1 5550.3 5594.6 5610.7 5616.7 5701.7 5784.0 5789.3 5792.2 5845.4 5637.6 5640.7 5645.0 5647.8 5656.1 14:22:47 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | [#1] ext.html Cycles:180 Average:59894.62 Median:43425.17 stddev:115216.72 (265.3%) stddev-sans-first:115453.87 14:22:47 INFO - PROCESS | 18058 | Values: 582.5 618.6 620.5 623.2 635.0 34573.8 37174.3 37352.0 45079.3 46654.1 47478.0 47870.3 47926.8 48046.3 48112.8 8943.4 9076.2 9086.1 9098.1 9101.8 8839.8 8918.2 8920.0 8921.9 8936.1 8956.0 8977.6 8986.1 9025.0 9025.2 8926.3 8959.6 8974.4 8976.7 8985.8 8886.2 8915.3 8953.8 8956.2 8959.3 43997.9 44354.8 44390.8 44400.0 44421.8 3521.6 4010.5 4246.0 4261.4 4344.5 33671.3 34232.0 34603.5 34657.5 35143.5 4331.9 4395.6 4429.2 4429.3 4436.2 344638.0 345625.0 345774.0 347009.0 347813.0 60824.0 60886.7 60941.7 61226.4 61288.0 37899.0 38702.8 64340.0 64354.4 64540.4 16794.2 16918.5 16924.9 16938.2 16938.6 12619.6 12704.0 12714.5 12717.9 12724.0 20099.0 20372.4 20377.5 20569.9 20630.7 7169.6 7314.6 7481.4 7505.7 7597.2 1017.9 1066.2 1111.0 1165.7 1167.1 33958.0 34409.5 34627.8 34690.7 34818.1 937.9 1104.2 1116.1 1147.2 1208.0 17254.7 17968.1 17969.3 17984.6 18119.5 531506.0 532727.0 535823.0 536564.0 537404.0 60115.4 61509.4 61518.7 61841.1 61886.4 1239.7 1328.6 1361.4 1367.8 1391.1 33604.5 35423.5 35682.6 36035.8 36085.1 46721.3 46985.8 47137.0 47227.5 47238.3 395845.0 404676.0 405363.8 405886.0 406984.0 26284.0 26797.3 26847.3 28696.9 29728.6 49172.8 50471.7 50756.7 50778.2 51852.2 43040.4 43372.8 43536.0 44604.6 44965.0 42414.6 42726.0 42766.4 43028.8 43420.6 43429.8 44317.0 44662.8 45691.3 47373.0 35745.6 38744.6 38788.4 39240.6 40171.4 29554.7 29629.3 29978.3 29983.1 30233.0 14:22:47 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | [#2] jquery.html Cycles:180 Average:28795.35 Median:403.04 stddev:77351.28 (19192.1%) stddev-sans-first:77538.90 14:22:47 INFO - PROCESS | 18058 | Values: 402.2 403.8 407.0 411.7 422.3 14369.9 18703.2 20653.5 20657.6 20733.3 18762.6 19685.2 19832.7 20558.2 20883.9 5462.3 5583.7 5589.6 5592.4 5614.5 4107.3 5472.8 5508.2 5515.8 5519.3 5851.3 6159.0 6166.0 6248.8 6251.0 6196.8 6200.2 6234.5 6707.6 6712.6 6000.4 6006.3 6007.2 6029.4 6034.8 24844.5 25539.0 25995.0 26126.6 26159.3 2190.0 2374.4 2413.7 2657.7 2734.2 10569.1 10607.5 10962.6 11322.8 11533.9 1963.7 1978.0 2013.9 2057.7 2072.6 87098.6 89860.0 91981.5 92226.5 93809.5 11851.9 11861.6 11914.4 11919.9 11966.6 16751.3 16915.7 16928.2 16959.8 16972.2 7692.5 7695.8 7816.3 7859.4 7876.1 7059.8 7104.9 7124.2 7196.3 7201.3 5162.0 5167.5 5215.9 5219.6 5288.8 2054.4 2093.4 2102.6 2109.6 2117.9 978.9 1034.6 1038.4 1043.5 1050.5 19567.9 20774.3 20941.7 20943.5 21279.3 949.2 976.4 980.7 991.8 1039.5 11359.9 11601.5 11736.8 11847.2 11870.5 465761.0 467515.0 467970.0 468823.0 477077.0 54195.7 57458.0 59684.4 86972.6 98728.5 926.5 930.2 941.9 942.0 944.2 19062.3 19134.2 19385.5 19468.4 19606.9 44268.6 44294.8 45823.5 46860.5 47666.0 55135.7 55422.4 56928.7 65167.3 66400.0 9416.0 9423.2 9569.7 9626.2 9856.9 13570.4 13789.2 13939.0 14356.9 14816.2 11893.7 12041.4 12089.8 12397.8 12688.7 12100.3 12333.9 12400.8 12507.1 12731.7 12879.1 12937.3 13020.2 13283.8 13349.3 9299.1 9426.4 9464.0 9533.8 9800.3 11452.8 12815.2 12851.6 12975.4 13074.3 14:22:47 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | [#3] mootools.html Cycles:180 Average:5858.38 Median:5045.24 stddev:3262.86 (64.7%) stddev-sans-first:3255.38 14:22:47 INFO - PROCESS | 18058 | Values: 1474.5 1505.6 1654.4 1769.3 1804.3 8413.1 8891.8 9002.1 9014.5 9015.3 7859.4 8051.6 8260.0 8275.3 8781.7 2393.3 2419.9 2421.9 2422.2 2427.9 2417.8 2422.6 2444.7 2453.9 2454.2 2114.1 2364.2 2432.4 2443.5 2464.6 2438.2 2446.3 2474.5 2477.3 2493.4 2432.2 2450.0 2461.5 2461.8 2463.3 8802.3 8936.8 8941.0 8942.1 8951.9 5309.1 5442.2 5447.3 5450.9 5451.6 3308.4 3365.6 3440.4 3441.1 3509.4 1067.1 1085.3 1093.1 1100.3 1109.7 12301.2 12303.6 12318.1 12332.6 12399.9 4883.5 4901.3 4918.6 5018.6 5026.4 10358.7 10373.9 10399.9 10403.4 10411.2 5475.6 5500.0 5507.5 5510.3 5513.3 4979.2 5064.1 5073.3 5073.6 5089.8 4112.9 4124.3 4137.7 4153.6 4170.0 1256.2 1323.0 1344.2 1358.5 1359.1 804.0 838.1 869.4 916.8 959.4 5965.4 6052.2 6168.4 6205.5 6266.6 976.9 983.0 990.8 1023.5 1099.4 3953.7 4090.1 4122.1 4144.7 4271.1 10712.3 10883.3 10943.7 11052.9 11062.2 9666.3 10299.8 10936.6 10940.9 10956.5 8021.5 8243.3 8266.7 8268.5 8270.9 5838.0 5864.5 6005.2 6011.9 6135.4 9601.2 10241.7 10247.4 10279.0 10290.2 10027.7 10296.2 10376.9 10404.7 10416.7 7718.2 7748.6 7850.6 7872.4 7905.8 8489.4 8535.2 8610.1 8610.4 8611.7 7714.5 7862.2 7884.4 7994.8 8007.6 7720.5 7727.2 7764.2 7889.8 7918.4 6602.2 6652.1 6677.0 6678.3 6687.5 5090.8 5157.9 5238.5 5274.9 5334.2 5209.8 5210.1 5215.4 5283.8 5354.4 14:22:47 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | [#4] prototype.html Cycles:180 Average:4564.56 Median:5113.18 stddev:1291.18 (25.3%) stddev-sans-first:1255.15 14:22:47 INFO - PROCESS | 18058 | Values: 334.2 343.7 352.9 353.3 358.0 5153.2 5229.5 5258.7 5306.6 5318.6 5237.3 5310.3 5316.3 5319.6 5342.9 4204.5 4211.5 4229.8 4236.5 4236.6 3955.3 4009.8 4167.3 4204.0 4221.2 4149.8 4160.9 4173.8 4180.2 4182.4 4149.0 4154.5 4156.3 4163.8 4173.3 3675.8 3688.5 3744.4 3746.2 3753.1 5066.3 5072.1 5161.4 5161.4 5164.2 4746.4 4747.6 4753.6 4764.6 4769.9 5351.3 5462.2 5482.7 5575.9 5576.0 4132.3 4170.3 4170.8 4177.2 4182.2 5711.9 5759.7 5767.4 5769.7 5769.7 4184.2 4267.4 4294.0 4298.6 4315.3 4329.7 4344.0 4347.9 4354.2 4362.6 4850.8 4857.8 4863.1 4866.8 4882.6 5342.5 5599.4 5605.0 5646.2 5653.5 1418.2 1465.8 1478.1 1495.7 1501.9 992.9 1021.0 1025.4 1031.3 1034.2 5300.6 5303.6 5318.7 5328.6 5333.5 5579.7 5598.0 5620.5 5638.7 5648.2 5130.6 5229.9 5247.4 5347.3 5371.5 2619.7 2647.9 2653.3 2679.6 2681.2 5143.7 5165.4 5166.6 5186.3 5209.5 4760.7 5084.4 5102.7 5108.4 5117.9 5120.4 5123.7 5132.7 5173.0 5182.3 4899.9 4972.7 4978.8 4999.5 5002.3 4709.7 4888.7 4901.8 4916.1 5002.8 5138.5 5140.2 5141.4 5171.3 5188.6 3873.8 3882.0 3901.4 3902.9 3915.8 5017.4 5273.6 5524.0 5578.6 5734.2 5549.5 5560.7 5576.2 5583.7 5595.6 5494.3 5504.0 5537.4 5558.2 5578.9 5253.6 5503.9 5506.6 5529.5 5533.6 5587.3 5604.2 5614.4 5617.4 5640.7 5235.9 5515.6 5516.9 5524.0 5526.9 14:22:47 INFO - PROCESS | 18058 | 14:22:47 INFO - PROCESS | 18058 | [#5] yui.html Cycles:180 Average:22813.14 Median:3757.68 stddev:33591.93 (894.0%) stddev-sans-first:33645.30 14:22:47 INFO - PROCESS | 18058 | Values: 743.9 750.8 752.0 775.6 781.8 15865.9 16803.7 16915.1 16975.0 16998.0 14943.8 15031.7 15048.0 15072.1 15152.2 700.8 841.2 849.7 854.2 855.6 838.2 846.4 846.4 846.8 847.0 898.4 898.8 900.0 900.2 900.4 892.7 896.0 896.1 896.4 896.7 651.2 651.5 651.5 651.9 651.9 16588.3 16593.3 16606.2 16623.3 16629.5 14623.1 15009.3 15037.3 15287.7 15583.1 13396.6 13523.9 14163.4 14188.7 14760.1 4703.7 4717.5 4757.1 4793.0 4834.6 77429.6 77561.6 78857.8 79335.6 79635.6 12437.8 12505.5 12628.2 12962.7 13235.3 23076.3 23079.5 23218.8 23225.7 23242.7 8871.3 9089.0 9093.3 9177.1 9379.5 4818.9 4892.4 4892.8 4961.1 5160.0 3702.4 3812.9 3814.3 3818.4 3821.0 649.8 720.4 766.7 772.1 778.9 632.8 726.2 752.9 770.5 779.7 10263.3 10311.7 10534.0 10929.2 10997.9 625.0 748.8 769.3 774.7 782.2 4967.0 5147.2 5165.4 5224.3 5237.5 128559.4 131708.0 132252.0 132531.0 134869.0 114382.0 114976.4 115698.4 116725.0 119470.0 65392.0 103625.5 103943.5 104405.0 105593.5 9767.2 9770.5 9856.1 9923.3 10027.2 47040.0 47135.8 59079.7 60987.4 61226.4 54191.7 78100.0 79183.2 79938.6 80687.0 13761.2 13885.7 14159.4 14190.8 14272.7 15723.2 16183.5 16267.9 16371.0 16809.6 14659.8 14699.8 15146.4 15661.8 15668.5 14051.2 14794.3 14938.2 15064.5 15552.3 14001.6 14523.7 14676.6 14852.3 15121.8 12047.4 12054.3 12219.3 12235.4 12609.2 11803.2 12374.0 12521.3 12530.6 12734.0 14:22:47 INFO - PROCESS | 18058 | -------- Summary: end -------- 14:22:47 INFO - PROCESS | 18058 | 14:22:48 INFO - TEST-INFO | 18058: exit 0 14:22:48 INFO - TEST-OK | dromaeo_css | took 1115814ms 14:22:48 INFO - TEST-START | kraken 14:22:48 INFO - operating with platform_type : linux_ 14:22:48 INFO - Initialising browser for kraken test... 14:22:48 INFO - TEST-INFO | started process 18252 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2H_N_A/profile http://localhost:45790/getInfo.html) 14:22:53 INFO - PROCESS | 18252 | __metrics Screen width/height:1600/1200 14:22:53 INFO - PROCESS | 18252 | colorDepth:24 14:22:53 INFO - PROCESS | 18252 | Browser inner width/height: 1024/697 14:22:53 INFO - PROCESS | 18252 | __metrics 14:22:55 INFO - PROCESS | 18252 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:22:56 INFO - TEST-INFO | 18252: exit 0 14:22:56 INFO - Browser initialized. 14:22:56 INFO - Running cycle 1/1 for kraken test... 14:22:56 INFO - TEST-INFO | started process 18335 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2H_N_A/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:23:07 INFO - PROCESS | 18335 | RSS: Main: 157519872 14:23:07 INFO - PROCESS | 18335 | 14:23:10 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:45790/tests/kraken/driver.html?testName=audio-beat-detection) 14:23:11 INFO - PROCESS | 18335 | RSS: Main: 215916544 14:23:11 INFO - PROCESS | 18335 | 14:23:13 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:45790/tests/kraken/driver.html?testName=audio-dft) 14:23:14 INFO - PROCESS | 18335 | RSS: Main: 205168640 14:23:14 INFO - PROCESS | 18335 | 14:23:17 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:45790/tests/kraken/driver.html?testName=audio-fft) 14:23:18 INFO - PROCESS | 18335 | RSS: Main: 269180928 14:23:18 INFO - PROCESS | 18335 | 14:23:20 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:45790/tests/kraken/driver.html?testName=audio-oscillator) 14:23:20 INFO - PROCESS | 18335 | RSS: Main: 179965952 14:23:20 INFO - PROCESS | 18335 | 14:23:22 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:45790/tests/kraken/driver.html?testName=imaging-gaussian-blur) 14:23:23 INFO - PROCESS | 18335 | RSS: Main: 184119296 14:23:23 INFO - PROCESS | 18335 | 14:23:26 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:45790/tests/kraken/driver.html?testName=imaging-darkroom) 14:23:27 INFO - PROCESS | 18335 | RSS: Main: 219025408 14:23:27 INFO - PROCESS | 18335 | 14:23:30 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:45790/tests/kraken/driver.html?testName=imaging-desaturate) 14:23:31 INFO - PROCESS | 18335 | RSS: Main: 221347840 14:23:31 INFO - PROCESS | 18335 | 14:23:34 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:45790/tests/kraken/driver.html?testName=json-parse-financial) 14:23:34 INFO - PROCESS | 18335 | RSS: Main: 221573120 14:23:34 INFO - PROCESS | 18335 | 14:23:36 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:45790/tests/kraken/driver.html?testName=json-stringify-tinderbox) 14:23:36 INFO - PROCESS | 18335 | RSS: Main: 207966208 14:23:36 INFO - PROCESS | 18335 | 14:23:38 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:45790/tests/kraken/driver.html?testName=stanford-crypto-aes) 14:23:39 INFO - PROCESS | 18335 | RSS: Main: 212979712 14:23:39 INFO - PROCESS | 18335 | 14:23:41 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:45790/tests/kraken/driver.html?testName=stanford-crypto-ccm) 14:23:41 INFO - PROCESS | 18335 | RSS: Main: 210538496 14:23:41 INFO - PROCESS | 18335 | 14:23:44 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:45790/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 14:23:44 INFO - PROCESS | 18335 | RSS: Main: 223268864 14:23:44 INFO - PROCESS | 18335 | 14:23:47 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:45790/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 14:23:48 INFO - PROCESS | 18335 | RSS: Main: 223879168 14:23:48 INFO - PROCESS | 18335 | 14:23:49 INFO - PROCESS | 18335 | Cycle 1(1): loaded http://localhost:45790/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:45790/tests/kraken/driver.html?testName=ai-astar) 14:23:50 INFO - PROCESS | 18335 | RSS: Main: 266919936 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | __start_tp_report 14:23:50 INFO - PROCESS | 18335 | _x_x_mozilla_page_load 14:23:50 INFO - PROCESS | 18335 | _x_x_mozilla_page_load_details 14:23:50 INFO - PROCESS | 18335 | |i|pagename|runs| 14:23:50 INFO - PROCESS | 18335 | |0;ai-astar;103;111;109;108;110;110;108;110;111;109 14:23:50 INFO - PROCESS | 18335 | |1;audio-beat-detection;148;122;119;173;119;119;141;116;163;117 14:23:50 INFO - PROCESS | 18335 | |2;audio-dft;160;161;161;160;160;161;160;161;160;160 14:23:50 INFO - PROCESS | 18335 | |3;audio-fft;74;74;75;127;74;74;73;74;107;75 14:23:50 INFO - PROCESS | 18335 | |4;audio-oscillator;83;85;116;84;83;83;123;82;84;129 14:23:50 INFO - PROCESS | 18335 | |5;imaging-gaussian-blur;116;117;117;117;117;116;117;117;117;117 14:23:50 INFO - PROCESS | 18335 | |6;imaging-darkroom;146;146;146;145;145;146;145;147;147;145 14:23:50 INFO - PROCESS | 18335 | |7;imaging-desaturate;95;96;95;95;96;94;95;95;95;96 14:23:50 INFO - PROCESS | 18335 | |8;json-parse-financial;54;52;53;52;53;53;54;54;52;53 14:23:50 INFO - PROCESS | 18335 | |9;json-stringify-tinderbox;59;60;61;61;71;61;61;61;61;60 14:23:50 INFO - PROCESS | 18335 | |10;stanford-crypto-aes;76;76;74;73;80;75;75;74;75;78 14:23:50 INFO - PROCESS | 18335 | |11;stanford-crypto-ccm;128;118;117;119;117;119;118;126;163;137 14:23:50 INFO - PROCESS | 18335 | |12;stanford-crypto-pbkdf2;159;156;158;161;151;152;152;153;150;153 14:23:50 INFO - PROCESS | 18335 | |13;stanford-crypto-sha256-iterative;64;64;63;65;62;63;61;62;60;60 14:23:50 INFO - PROCESS | 18335 | __end_tp_report 14:23:50 INFO - PROCESS | 18335 | __start_cc_report 14:23:50 INFO - PROCESS | 18335 | _x_x_mozilla_cycle_collect,1645 14:23:50 INFO - PROCESS | 18335 | __end_cc_report 14:23:50 INFO - PROCESS | 18335 | __startTimestamp1467408230032__endTimestamp 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | ------- Summary: start ------- 14:23:50 INFO - PROCESS | 18335 | Number of tests: 14 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#0] ai-astar Cycles:10 Average:108.90 Median:110.00 stddev:2.33 (2.1%) stddev-sans-first:1.13 14:23:50 INFO - PROCESS | 18335 | Values: 103.0 111.0 109.0 108.0 110.0 110.0 108.0 110.0 111.0 109.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#1] audio-beat-detection Cycles:10 Average:133.70 Median:131.50 stddev:21.18 (16.1%) stddev-sans-first:21.83 14:23:50 INFO - PROCESS | 18335 | Values: 148.0 122.0 119.0 173.0 119.0 119.0 141.0 116.0 163.0 117.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#2] audio-dft Cycles:10 Average:160.40 Median:160.50 stddev:0.52 (0.3%) stddev-sans-first:0.53 14:23:50 INFO - PROCESS | 18335 | Values: 160.0 161.0 161.0 160.0 160.0 161.0 160.0 161.0 160.0 160.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#3] audio-fft Cycles:10 Average:82.70 Median:74.00 stddev:18.69 (25.3%) stddev-sans-first:19.56 14:23:50 INFO - PROCESS | 18335 | Values: 74.0 74.0 75.0 127.0 74.0 74.0 73.0 74.0 107.0 75.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#4] audio-oscillator Cycles:10 Average:95.20 Median:83.00 stddev:19.22 (23.2%) stddev-sans-first:19.87 14:23:50 INFO - PROCESS | 18335 | Values: 83.0 85.0 116.0 84.0 83.0 83.0 123.0 82.0 84.0 129.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#5] imaging-gaussian-blur Cycles:10 Average:116.80 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 14:23:50 INFO - PROCESS | 18335 | Values: 116.0 117.0 117.0 117.0 117.0 116.0 117.0 117.0 117.0 117.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#6] imaging-darkroom Cycles:10 Average:145.80 Median:146.00 stddev:0.79 (0.5%) stddev-sans-first:0.83 14:23:50 INFO - PROCESS | 18335 | Values: 146.0 146.0 146.0 145.0 145.0 146.0 145.0 147.0 147.0 145.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:0.63 (0.7%) stddev-sans-first:0.67 14:23:50 INFO - PROCESS | 18335 | Values: 95.0 96.0 95.0 95.0 96.0 94.0 95.0 95.0 95.0 96.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#8] json-parse-financial Cycles:10 Average:53.00 Median:53.00 stddev:0.82 (1.5%) stddev-sans-first:0.78 14:23:50 INFO - PROCESS | 18335 | Values: 54.0 52.0 53.0 52.0 53.0 53.0 54.0 54.0 52.0 53.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#9] json-stringify-tinderbox Cycles:10 Average:61.60 Median:61.00 stddev:3.37 (5.5%) stddev-sans-first:3.44 14:23:50 INFO - PROCESS | 18335 | Values: 59.0 60.0 61.0 61.0 71.0 61.0 61.0 61.0 61.0 60.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#10] stanford-crypto-aes Cycles:10 Average:75.60 Median:75.50 stddev:2.07 (2.7%) stddev-sans-first:2.19 14:23:50 INFO - PROCESS | 18335 | Values: 76.0 76.0 74.0 73.0 80.0 75.0 75.0 74.0 75.0 78.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#11] stanford-crypto-ccm Cycles:10 Average:126.20 Median:122.50 stddev:14.46 (11.8%) stddev-sans-first:15.32 14:23:50 INFO - PROCESS | 18335 | Values: 128.0 118.0 117.0 119.0 117.0 119.0 118.0 126.0 163.0 137.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:154.50 Median:154.50 stddev:3.75 (2.4%) stddev-sans-first:3.61 14:23:50 INFO - PROCESS | 18335 | Values: 159.0 156.0 158.0 161.0 151.0 152.0 152.0 153.0 150.0 153.0 14:23:50 INFO - PROCESS | 18335 | 14:23:50 INFO - PROCESS | 18335 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.40 Median:63.00 stddev:1.71 (2.7%) stddev-sans-first:1.72 14:23:50 INFO - PROCESS | 18335 | Values: 64.0 64.0 63.0 65.0 62.0 63.0 61.0 62.0 60.0 60.0 14:23:50 INFO - PROCESS | 18335 | -------- Summary: end -------- 14:23:50 INFO - PROCESS | 18335 | 14:23:51 INFO - TEST-INFO | 18335: exit 0 14:23:51 INFO - TEST-OK | kraken | took 62668ms 14:23:51 INFO - SUITE-END | took 1178s 14:23:51 INFO - Completed test suite (00:19:38) 14:23:51 INFO - javascript benchmark 14:23:51 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3118.7816852820306, 3123.7032481914225, 3140.13646247282, 3163.9683603163962, 3188.0, 5243.711595862226, 5301.814436494724, 5410.675359478434, 5514.834554963348, 5526.364468086176, 5397.649152805075, 5405.108157154074, 5415.756290966906, 5446.210299506569, 5512.5589952803775, 4836.226203807391, 4875.073735990169, 4919.704817710931, 4936.160852655039, 4996.7001979881325, 4904.803807847682, 4938.629602779788, 4955.851324460254, 4966.726830024347, 4973.452920178777, 4821.204501257288, 4855.975720121412, 4887.169181239163, 4910.901781964377, 4984.0281145176705, 4810.086083644132, 4817.686850354716, 4819.95180048202, 4904.9699563091435, 4982.825601103944, 4831.806727730886, 4884.218525035977, 4884.975575122102, 4884.998575292057, 4932.556069953722, 5285.68285902847, 5329.573634109301, 5427.43011983744, 5480.671159730429, 5490.066688662937, 5743.913841292384, 5830.300363956352, 5856.531477481792, 5859.8535036624, 5866.061430171152, 5841.386654401269, 5854.326752423483, 5891.705414729289, 5903.409659034105, 5910.763569457216, 5292.655977361498, 5372.811951581754, 5422.0, 5502.449755024506, 5509.889802203974, 6016.548758843104, 6017.187679663277, 6020.518358531307, 6023.879522409527, 6028.819135425944, 5717.771289148471, 5722.856928576819, 5757.481826635623, 5772.826815195551, 5774.307083150049, 5584.329880414295, 5631.239782629293, 5670.347909990322, 5684.317881854204, 5858.443447872445, 5711.257536520226, 5722.37053924068, 5728.627639203439, 5730.312362516442, 5731.083026715705, 5690.9146362804595, 5696.11710184922, 5731.426857314319, 5736.110902810071, 5743.6266642668925, 4319.67602429819, 4362.563743625676, 4365.039691267916, 4412.84555040572, 4416.227160246944, 3949.6642785363565, 3964.702647301406, 3975.840966361371, 3983.701222408331, 3983.9601603983588, 5231.267622532849, 5402.432744561843, 5455.1271796512365, 5472.069748142825, 5519.69641669712, 5836.88326233473, 5839.708014599338, 5845.123231515222, 5847.590668653153, 5882.294124705063, 5433.8369848904595, 5444.074507333763, 5479.780808767684, 5483.424240454775, 5501.477359650827, 4850.95149048512, 4885.0, 4904.5340692634145, 4912.70523768575, 5027.044861476381, 5882.617629854131, 5888.146218798251, 5893.616914900518, 5897.469227769436, 5897.469227769521, 5652.869426114711, 5699.658020518699, 5706.686132262766, 5708.286464191976, 5708.800191993427, 5780.104083867007, 5806.65160090396, 5858.765649373977, 5883.852903677271, 5920.467157955804, 5629.380768115586, 5630.211770352236, 5631.239782629293, 5634.408387119293, 5640.153976903333, 5621.044422448112, 5728.742206600629, 5730.054541000688, 5741.712914354182, 5741.971290143522, 5589.021921163861, 5608.10270356741, 5665.461781130786, 5725.312962444534, 5733.455321744427, 5664.207011018543, 5694.743736531949, 5700.942990570041, 5707.372189059283, 5713.457221563945, 5411.107167317348, 5550.27846379968, 5594.580406469449, 5610.747516361692, 5616.7191640416995, 5701.657900525982, 5784.045632470596, 5789.305283366023, 5792.21805056312, 5845.41545845429, 5637.605367624227, 5640.661560306231, 5644.971775141263, 5647.830565083054, 5656.095024796013], "value": 5324.017308150924, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [582.5165112956247, 618.6164577961663, 620.4509009526573, 623.2427600465435, 634.984125396865, 34573.827130864345, 37174.25651486969, 37352.0, 45079.32381014279, 46654.06691866161, 47478.0, 47870.28194577084, 47926.76036619812, 48046.279305810356, 48112.75943620277, 8943.373963822518, 9076.183143517082, 9086.136817002374, 9098.090190980914, 9101.817963640757, 8839.77900552488, 8918.241949434307, 8920.03759172981, 8921.866172007425, 8936.106389361077, 8956.0, 8977.551122443885, 8986.056464071276, 9024.954875225614, 9025.232855207316, 8926.330525210635, 8959.552022398919, 8974.371793974424, 8976.685815996441, 8985.820283594358, 8886.200241978253, 8915.331350148765, 8953.820923581558, 8956.193942545202, 8959.328050396247, 43997.900052498626, 44354.77822610866, 44390.77804610956, 44400.0, 44421.77789111066, 3521.6126226115107, 4010.4786377770993, 4245.957540424618, 4261.403403523509, 4344.478662560481, 33671.326573468396, 34232.0, 34603.4809477858, 34657.48013779795, 35143.4728479073, 4331.935020974688, 4395.648348132142, 4429.247028005247, 4429.291313389875, 4436.245838207513, 344638.0, 345624.9999999975, 345774.0, 347009.0, 347813.0, 60824.0, 60886.695566521885, 60941.69529152326, 61226.387736122066, 61288.0, 37899.0, 38702.80648596739, 64340.0, 64354.356456434834, 64540.354596454374, 16794.24425900813, 16918.492445226664, 16924.915375423043, 16938.153092345332, 16938.576535586464, 12619.621411357673, 12704.047196460118, 12714.491420343267, 12717.936410318074, 12724.04569657261, 20099.0, 20372.388828335173, 20377.49056273605, 20569.897150514153, 20630.690539641917, 7169.641517924083, 7314.597697126709, 7481.35410209753, 7505.6997720090585, 7597.164311925684, 1017.867677201959, 1066.2429674930886, 1110.9945499323126, 1165.6778182180885, 1167.1363191238593, 33958.0, 34409.483857742154, 34627.82686086604, 34690.65309346925, 34818.129546761535, 937.8968313485511, 1104.2380757277454, 1116.1349953785718, 1147.2485521982946, 1207.979257527388, 17254.741178882075, 17968.101594920463, 17969.281228750704, 17984.640307194044, 18119.45641630753, 531506.0, 532727.0, 535823.0, 536564.0, 537404.0, 60115.39884601098, 61509.38490615126, 61518.69240653768, 61841.07238391338, 61886.38113618896, 1239.7210627608715, 1328.6346254780012, 1361.4213959067356, 1367.8358596968228, 1391.0679844504207, 33604.49593256152, 35423.46864797082, 35682.64317356793, 36035.819820900724, 36085.09787255339, 46721.29918051164, 46985.76507117443, 47137.0, 47227.52772472231, 47238.291425627955, 395845.0, 404676.0, 405363.7586308682, 405886.0, 406984.0, 26284.0, 26797.330066748487, 26847.328816778954, 28696.85651571729, 29728.554071688508, 49172.75413623052, 50471.74764126156, 50756.74621626868, 50778.238326425875, 51852.222216667535, 43040.35439468473, 43372.783136084116, 43536.0, 44604.553954461335, 44965.0, 42414.57585424106, 42726.0, 42766.358504621836, 43028.78485607552, 43420.56579434165, 43429.78285108554, 44317.0, 44662.77668611636, 45691.31463028124, 47373.0, 35745.64254357527, 38744.6125538741, 38788.41817372685, 39240.626578069634, 40171.39742903917, 29554.690272564072, 29629.25926851846, 29978.25054373658, 29983.062095743524, 30233.0], "value": 20638.497764285, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [402.23775944585014, 403.83846461415413, 406.9918601627969, 411.66038018634623, 422.26736611978214, 14369.92815035926, 18703.158357873894, 20653.483662908417, 20657.586848263025, 20733.341332693388, 18762.62474750504, 19685.21259149632, 19832.70250946237, 20558.177672893067, 20883.895580522076, 5462.289902312704, 5583.6928968906695, 5589.552835773149, 5592.412796656333, 5614.522765564911, 4107.322291821846, 5472.781088756445, 5508.20131080993, 5515.779368825262, 5519.31008623922, 5851.297844258674, 6159.045347971071, 6165.969170154165, 6248.812535623939, 6251.031090181029, 6196.75212991482, 6200.16297799798, 6234.5324100692405, 6707.564008339491, 6712.630805305706, 6000.369961154103, 6006.309274433453, 6007.15899774032, 6029.397060293935, 6034.788782392639, 24844.50310993788, 25539.0, 25995.0, 26126.6081008785, 26159.346016349555, 2189.9562008759895, 2374.41826752445, 2413.7466911929714, 2657.734226577346, 2734.179746076169, 10569.10162636177, 10607.469626518721, 10962.616308429246, 11322.773544529064, 11533.884661153365, 1963.68581027035, 1978.0406502846108, 2013.8590298679098, 2057.722207501983, 2072.616565935307, 87098.56450717706, 89860.0, 91981.54009229978, 92226.53886730524, 93809.53095234481, 11851.88148118525, 11861.5848445304, 11914.404279785977, 11919.88080119205, 11966.64100076999, 16751.329946802234, 16915.746263806053, 16928.153592320334, 16959.830401695825, 16972.23624936881, 7692.46152769312, 7695.846083078419, 7816.296533312029, 7859.410544209207, 7876.133625301212, 7059.752908648173, 7104.92895071053, 7124.216336203013, 7196.316349946746, 7201.279872012861, 5161.974190129025, 5167.509086636764, 5215.895682086337, 5219.608529360313, 5288.788448462018, 2054.41449186984, 2093.3510611710417, 2102.611016961867, 2109.588630217093, 2117.90469428873, 978.9070038346346, 1034.6016783538391, 1038.3717850700368, 1043.4574021508772, 1050.4642632257603, 19567.902160489106, 20774.272900448414, 20941.685874711893, 20943.476413089793, 21279.255226067322, 949.2263804998904, 976.4483067067226, 980.7499087732582, 991.7768502086973, 1039.4542864995788, 11359.943200284111, 11601.535938562532, 11736.765264694659, 11847.170698051053, 11870.465829037714, 465761.0, 467515.0, 467970.0, 468823.0, 477077.0, 54195.72902135543, 57458.0, 59684.403155967884, 86972.56513717391, 98728.50635746775, 926.5321012888448, 930.1721467893581, 941.8963913969458, 941.9764505887271, 944.1596978688972, 19062.33281835129, 19134.23463061462, 19385.51536211606, 19468.415947521597, 19606.90196549065, 44268.55731442644, 44294.77852610716, 45823.541764581925, 46860.53139468698, 47666.0, 55135.72432137813, 55422.44577554173, 56928.71535642461, 65167.34832651613, 66400.0, 9415.95292023563, 9423.151916327564, 9569.712908612753, 9626.181774549243, 9856.852147217654, 13570.38933248026, 13789.24159171215, 13939.0, 14356.85643143597, 14816.185109818633, 11893.702657433634, 12041.397930103285, 12089.75820483603, 12397.75204495923, 12688.6827829305, 12100.334481603597, 12333.93833030829, 12400.81398779001, 12507.061970352443, 12731.745365092462, 12879.098463107492, 12937.28844913501, 13020.153690010118, 13283.80074298867, 13349.332533373099, 9299.070092990647, 9426.387284826464, 9464.0, 9533.809323813346, 9800.313978021755, 11452.828207576726, 12815.231086134861, 12851.614451566467, 12975.416106275052, 13074.346282686018], "value": 9590.758232119764, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1474.4839306242814, 1505.6160679026846, 1654.4292219184385, 1769.3188122572806, 1804.2963244334703, 8413.116622754607, 8891.777705557348, 9002.054784247657, 9014.504202268872, 9015.278777697786, 7859.449838511307, 8051.597420128999, 8260.0, 8275.337972962163, 8781.736547903558, 2393.3059412770317, 2419.8790060496995, 2421.878906054699, 2422.2491027781357, 2427.9271621851285, 2417.7703118203744, 2422.648715936188, 2444.743301953296, 2453.901843926241, 2454.214651311581, 2114.06980928391, 2364.196173301077, 2432.4405386761055, 2443.4746529496156, 2464.581021226396, 2438.198779407225, 2446.315031791092, 2474.5298393305216, 2477.343503971449, 2493.3891196656937, 2432.2460037388464, 2449.9755002449924, 2461.54461424637, 2461.778439940414, 2463.322586288767, 8802.251808596277, 8936.776580585472, 8940.955295223548, 8942.105789421006, 8951.865722014176, 5309.097453432925, 5442.156465747816, 5447.291852059207, 5450.945490545084, 5451.64564303319, 3308.4044871923043, 3365.562476878015, 3440.3807314683345, 3441.1225137590004, 3509.4209455440077, 1067.1089640150483, 1085.3270971997333, 1093.1309608860975, 1100.3068067117665, 1109.6504601050642, 12301.200421972542, 12303.630891073282, 12318.137730358878, 12332.568360107352, 12399.938000309941, 4883.536064073907, 4901.264810278415, 4918.606511479073, 5018.623603229772, 5026.421961474404, 10358.689239322832, 10373.896261037293, 10399.948000260101, 10403.375797452178, 10411.219158563137, 5475.589330800126, 5499.972500137474, 5507.504324610804, 5510.338759348904, 5513.255710479034, 4979.178435558165, 5064.063148317573, 5073.34046573943, 5073.568746656501, 5089.847304580869, 4112.91774164515, 4124.319487284624, 4137.686965155542, 4153.605407486284, 4169.958300417018, 1256.1772039314264, 1322.9867701323055, 1344.227069435059, 1358.517726207202, 1359.136948038003, 803.9829615536352, 838.0906716212977, 869.4479005831342, 916.834969705446, 959.4339339789558, 5965.403459654, 6052.213212282375, 6168.414000669929, 6205.503559715212, 6266.592671476339, 976.9023097690316, 982.9678837221032, 990.7919336939324, 1023.4626820919077, 1099.378850949211, 3953.723239373216, 4090.1206240658403, 4122.051928056504, 4144.70987030905, 4271.124419493996, 10712.250142489951, 10883.292585981886, 10943.726406839893, 11052.889471105185, 11062.170337224741, 9666.323357365058, 10299.845502317472, 10936.617218397318, 10940.890591093987, 10956.506957186946, 8021.5187088774865, 8243.340532757366, 8266.710665126811, 8268.462549934355, 8270.917290827014, 5838.0, 5864.501517371071, 6005.249343832021, 6011.879762404815, 6135.447809697149, 9601.231901447727, 10241.743956400851, 10247.436390998566, 10279.0, 10290.176785857264, 10027.699169024942, 10296.17630589536, 10376.896231037594, 10404.739881503023, 10416.739581510219, 7718.15100338951, 7748.612569371621, 7850.646720897687, 7872.37021038327, 7905.841883162189, 8489.40574159803, 8535.189157030072, 8610.13898610134, 8610.354223433142, 8611.6985905493, 7714.498557593738, 7862.213778622092, 7884.4086693497065, 7994.760157195294, 8007.639656215601, 7720.53676779395, 7727.150013498623, 7764.184760600056, 7889.84220315579, 7918.366530677416, 6602.240742314695, 6652.068710380648, 6677.0, 6678.265390807104, 6687.465002799861, 5090.770915308746, 5157.896842063213, 5238.5023422774775, 5274.8945021100135, 5334.173203153362, 5209.76172022494, 5210.062188806051, 5215.426303106579, 5283.788648454019, 5354.3842458117815], "value": 4716.058677025274, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [334.18458960137264, 343.7421933549838, 352.89413176047185, 353.33925559204295, 357.9856805727771, 5153.1754919212835, 5229.450907654698, 5258.710770907599, 5306.575473962079, 5318.643745844814, 5237.3453318335205, 5310.256564081022, 5316.282301889244, 5319.627626066177, 5342.866428339294, 4204.474440694913, 4211.5367309595995, 4229.7885105744745, 4236.491621005468, 4236.639885609711, 3955.3275943089743, 4009.83960641574, 4167.3332266837315, 4203.957960420387, 4221.2190744712325, 4149.792510374485, 4160.916781664365, 4173.791310434482, 4180.205760905418, 4182.435371224891, 4148.979255103705, 4154.459920210368, 4156.251874662559, 4163.791810409467, 4173.332266837322, 3675.815562246487, 3688.5020522229424, 3744.3821769408014, 3746.1571146492092, 3753.1367785409507, 5066.328111723123, 5072.137736584789, 5161.4322424533275, 5161.4322424533275, 5164.173732202829, 4746.359241502388, 4747.620190384761, 4753.619710423192, 4764.6426518011285, 4769.928451073237, 5351.304330437058, 5462.2079798429, 5482.698451585201, 5575.944240557583, 5576.0, 4132.276851550967, 4170.332746760504, 4170.812313445902, 4177.164567086565, 4182.226288136704, 5711.942880571182, 5759.654420734728, 5767.36558978512, 5769.711514424262, 5769.711514424304, 4184.163167366539, 4267.445232119867, 4293.97853010733, 4298.613124818781, 4315.28797748368, 4329.718568293051, 4344.0, 4347.891302717458, 4354.238008348526, 4362.629176520031, 4850.80596776125, 4857.757112144379, 4863.106451661256, 4866.7566621668775, 4882.633802464829, 5342.465753424626, 5599.356074051455, 5604.971975140098, 5646.2377579027125, 5653.462921022497, 1418.1987177244823, 1465.8314293856129, 1478.1279045363287, 1495.7158139953592, 1501.9111144420208, 992.9205663546899, 1020.9897901021043, 1025.410389026298, 1031.298716872519, 1034.1623285139062, 5300.602454815904, 5303.575713942875, 5318.73406329682, 5328.573714102862, 5333.519983201453, 5579.69311687861, 5598.0, 5620.494155526022, 5638.746256418471, 5648.15277708347, 5130.563902068366, 5229.921551176735, 5247.370315562157, 5347.304850369427, 5371.543418809367, 2619.7118316985116, 2647.9275893262875, 2653.283613424365, 2679.5846643770246, 2681.2358477833723, 5143.742812859342, 5165.405978312542, 5166.55336505779, 5186.273921650972, 5209.505097015777, 4760.690555113906, 5084.41529224144, 5102.719350435687, 5108.438071812097, 5117.923231151536, 5120.411152717411, 5123.66696164763, 5132.692038477629, 5172.965406918632, 5182.326297581366, 4899.853004409873, 4972.726500042532, 4978.775955081957, 4999.450060493416, 5002.274670172877, 4709.740964246999, 4888.706677599355, 4901.779419926183, 4916.139675556692, 5002.799888004439, 5138.486151384832, 5140.151874940593, 5141.408737995179, 5171.3277273954145, 5188.55897248723, 3873.806309684448, 3882.0007696036, 3901.4147877818555, 3902.8829135125993, 3915.8433662653174, 5017.448080711046, 5273.578113750814, 5523.978064058162, 5578.56917995438, 5734.22587950638, 5549.500544950974, 5560.7219639018695, 5576.247206627054, 5583.664980101207, 5595.552355811444, 5494.2857428534035, 5504.0, 5537.36320323168, 5558.166275058774, 5578.888422231452, 5253.579713622978, 5503.862403439786, 5506.559475242051, 5529.502344788988, 5533.6126471148245, 5587.329520457572, 5604.2154098425435, 5614.41048689898, 5617.354004289396, 5640.661560306395, 5235.921461178162, 5515.558755299647, 5516.862078448071, 5524.0, 5526.917096243479], "value": 4165.275215105409, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [743.9070116235471, 750.8122969257687, 751.9699212031518, 775.6160700453277, 781.8319061401797, 15865.920670396647, 16803.747943780836, 16915.06967116808, 16975.0, 16998.0, 14943.775843362359, 15031.699366012674, 15048.0, 15072.095674259552, 15152.242387880617, 700.8318003679119, 841.2302742990157, 849.7365816596844, 854.1629203380691, 855.5593869157389, 838.2204549768712, 846.3948276981956, 846.3990566697652, 846.7925358287229, 847.0174597466939, 898.371140201858, 898.8112496375769, 900.0369604523163, 900.1943260781596, 900.3922352412128, 892.7455675132557, 896.0412358776113, 896.1486587741639, 896.4262871762045, 896.6906417286026, 651.205529254309, 651.475562172451, 651.540663832002, 651.8631087471637, 651.8663673946829, 16588.25352859124, 16593.336266549322, 16606.169691515377, 16623.335066597323, 16629.50111496657, 14623.122612643276, 15009.283990825224, 15037.323320450607, 15287.694246115016, 15583.142927139002, 13396.598102056954, 13523.864761352359, 14163.433462661482, 14188.716225675429, 14760.114393136339, 4703.741294228816, 4717.457492388385, 4757.0723708876785, 4792.9760351198365, 4834.564889159958, 77429.61285193538, 77561.61219193925, 78857.81713274306, 79335.6033219836, 79635.6018219911, 12437.75124497505, 12505.499780008699, 12628.242305461701, 12962.740745185043, 13235.27206003679, 23076.307710768702, 23079.538409232056, 23218.76781232166, 23225.651615225786, 23242.65136022961, 8871.334649901155, 9089.046879137333, 9093.318001149808, 9177.128172823572, 9379.48412837287, 4818.855434336975, 4892.363992680928, 4892.755362231946, 4961.131801934647, 5160.045391602565, 3702.407614781622, 3812.942805857914, 3814.3134235837815, 3818.3508803503473, 3820.980895095562, 649.7985624456434, 720.4020662849927, 766.6856588798565, 772.0658003815334, 778.8831675248758, 632.8354627796714, 726.2156870579761, 752.8644843928146, 770.4799260499141, 779.7115067424976, 10263.272669600765, 10311.742206444898, 10534.047528631067, 10929.180311476672, 10997.945010275058, 624.9562530622812, 748.8202831320444, 769.3114662377141, 774.6668932359026, 782.1904329019437, 4966.975165124151, 5147.219193020735, 5165.380154381423, 5224.320838290998, 5237.528622424, 128559.35720321526, 131708.0, 132252.0, 132531.0, 134869.0, 114382.0, 114976.44556639879, 115698.42150789192, 116725.0, 119470.0, 65392.0, 103625.48187259016, 103943.48028259962, 104405.0, 105593.47203264089, 9767.169790567881, 9770.511474426392, 9856.112949834549, 9923.305368624417, 10027.197824174194, 47040.0, 47135.764321178176, 59079.70460147672, 60987.39012609817, 61226.387736122066, 54191.72904135454, 78100.0, 79183.20816791759, 79938.60030700042, 80687.0, 13761.243131627856, 13885.652858678613, 14159.43362265539, 14190.787138192729, 14272.71454570882, 15723.21383930776, 16183.514494564712, 16267.918660406622, 16371.0, 16809.571186449288, 14659.780103298246, 14699.779503307245, 15146.394144234107, 15661.84338156604, 15668.529944101696, 14051.156930584199, 14794.334254958769, 14938.178400187659, 15064.548063558112, 15552.30014649321, 14001.579952601438, 14523.658178062105, 14676.55970320892, 14852.331645076214, 15121.848781512044, 12047.397630118634, 12054.276743395425, 12219.26684398939, 12235.449404776984, 12609.243445393306, 11803.23278986863, 12374.0, 12521.31132787669, 12530.561430349893, 12734.0], "value": 8172.767483705876, "unit": "score"}], "name": "dromaeo_css", "value": 7437.065199097077, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 111.0, 109.0, 108.0, 110.0, 110.0, 108.0, 110.0, 111.0, 109.0], "value": 108.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 122.0, 119.0, 173.0, 119.0, 119.0, 141.0, 116.0, 163.0, 117.0], "value": 133.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 161.0, 161.0, 160.0, 160.0, 161.0, 160.0, 161.0, 160.0, 160.0], "value": 160.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 75.0, 127.0, 74.0, 74.0, 73.0, 74.0, 107.0, 75.0], "value": 82.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 85.0, 116.0, 84.0, 83.0, 83.0, 123.0, 82.0, 84.0, 129.0], "value": 95.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0], "value": 116.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 145.0, 145.0, 146.0, 145.0, 147.0, 147.0, 145.0], "value": 145.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 95.0, 95.0, 96.0, 94.0, 95.0, 95.0, 95.0, 96.0], "value": 95.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 52.0, 53.0, 52.0, 53.0, 53.0, 54.0, 54.0, 52.0, 53.0], "value": 53.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 60.0, 61.0, 61.0, 71.0, 61.0, 61.0, 61.0, 61.0, 60.0], "value": 61.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 74.0, 73.0, 80.0, 75.0, 75.0, 74.0, 75.0, 78.0], "value": 75.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [128.0, 118.0, 117.0, 119.0, 117.0, 119.0, 118.0, 126.0, 163.0, 137.0], "value": 126.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 156.0, 158.0, 161.0, 151.0, 152.0, 152.0, 153.0, 150.0, 153.0], "value": 154.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 64.0, 63.0, 65.0, 62.0, 63.0, 61.0, 62.0, 60.0, 60.0], "value": 62.4, "unit": "score"}], "name": "kraken", "value": 1472.0, "alertThreshold": 2.0}]} 14:23:51 INFO - Return code: 0 14:23:51 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 14:23:51 INFO - # TBPL SUCCESS # 14:23:51 INFO - Running post-action listener: _resource_record_post_action 14:23:51 INFO - ##### 14:23:51 INFO - ##### Finished run-tests step (success) 14:23:51 INFO - ##### 14:23:51 INFO - Running post-run listener: _resource_record_post_run 14:23:51 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 4096; Write bytes: 560730112; Read time: 12; Write time: 1195680 14:23:51 INFO - TinderboxPrint: CPU usage
13.1% 14:23:51 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 14:23:51 INFO - TinderboxPrint: I/O write bytes / time
560,730,112 / 1,195,680 14:23:51 INFO - TinderboxPrint: CPU idle
8,292.5 (86.9%) 14:23:51 INFO - TinderboxPrint: CPU user
1,198.9 (12.6%) 14:23:51 INFO - TinderboxPrint: Swap in / out
0 / 0 14:23:51 INFO - install - Wall time: 18s; CPU: 15.0%; Read bytes: 0; Write bytes: 267145216; Read time: 0; Write time: 525832 14:23:51 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 0; Write bytes: 293584896; Read time: 0; Write time: 669848 14:23:51 INFO - Running post-run listener: _upload_blobber_files 14:23:51 INFO - Blob upload gear active. 14:23:51 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 14:23:51 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 14:23:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 14:23:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 14:23:52 INFO - (blobuploader) - INFO - Open directory for files ... 14:23:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 14:23:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:23:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:23:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 14:23:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:23:53 INFO - (blobuploader) - INFO - Done attempting. 14:23:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 14:23:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:23:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:23:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 14:23:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:23:54 INFO - (blobuploader) - INFO - Done attempting. 14:23:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 14:23:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:23:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:23:57 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 14:23:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:23:57 INFO - (blobuploader) - INFO - Done attempting. 14:23:57 INFO - (blobuploader) - INFO - Iteration through files over. 14:23:57 INFO - Return code: 0 14:23:57 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 14:23:57 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 14:23:57 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/16697c7754e26000a253ce605fa25130ed5adb0c4368a8be15768a353d5a9cb7b3ea9c013e65e1765c356be31e8196194ef3d82ffcef230be016cc32e451f573", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c65dc961786c4eefec788daf24e366286e8816b6be623be7af71f1388dd72c585a5039d3082f3e4378e604d8dfbabb300c475abe2f8a8ff65cf1acca0cbf1404", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/875e5ec2f433ea2fd2cda13e4e5ba073911d4d00d09153459626033ba2823c9a92b993cbe16436b8f56061262a0dfe400eed2f3a2caa945d890ece18e9c1ffb2"} 14:23:57 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 14:23:57 INFO - Writing to file /builds/slave/test/properties/blobber_files 14:23:57 INFO - Contents: 14:23:57 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/16697c7754e26000a253ce605fa25130ed5adb0c4368a8be15768a353d5a9cb7b3ea9c013e65e1765c356be31e8196194ef3d82ffcef230be016cc32e451f573", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c65dc961786c4eefec788daf24e366286e8816b6be623be7af71f1388dd72c585a5039d3082f3e4378e604d8dfbabb300c475abe2f8a8ff65cf1acca0cbf1404", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/875e5ec2f433ea2fd2cda13e4e5ba073911d4d00d09153459626033ba2823c9a92b993cbe16436b8f56061262a0dfe400eed2f3a2caa945d890ece18e9c1ffb2"} 14:23:57 INFO - Running post-run listener: copy_logs_to_upload_dir 14:23:57 INFO - Copying logs to upload dir... 14:23:57 INFO - mkdir: /builds/slave/test/build/upload/logs 14:23:57 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.253672 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-07-01 14:23:57.449387) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-01 14:23:57.452682) ========= 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=5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/16697c7754e26000a253ce605fa25130ed5adb0c4368a8be15768a353d5a9cb7b3ea9c013e65e1765c356be31e8196194ef3d82ffcef230be016cc32e451f573", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c65dc961786c4eefec788daf24e366286e8816b6be623be7af71f1388dd72c585a5039d3082f3e4378e604d8dfbabb300c475abe2f8a8ff65cf1acca0cbf1404", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/875e5ec2f433ea2fd2cda13e4e5ba073911d4d00d09153459626033ba2823c9a92b993cbe16436b8f56061262a0dfe400eed2f3a2caa945d890ece18e9c1ffb2"} build_url:https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011438 build_url: 'https://queue.taskcluster.net/v1/task/MO-NG5lRRTadvAt1a6FdWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/16697c7754e26000a253ce605fa25130ed5adb0c4368a8be15768a353d5a9cb7b3ea9c013e65e1765c356be31e8196194ef3d82ffcef230be016cc32e451f573", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c65dc961786c4eefec788daf24e366286e8816b6be623be7af71f1388dd72c585a5039d3082f3e4378e604d8dfbabb300c475abe2f8a8ff65cf1acca0cbf1404", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/875e5ec2f433ea2fd2cda13e4e5ba073911d4d00d09153459626033ba2823c9a92b993cbe16436b8f56061262a0dfe400eed2f3a2caa945d890ece18e9c1ffb2"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-01 14:23:57.480706) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 14:23:57.481013) ========= 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=5cf47e208febbcd81da23b2e0000026f-1467404256.253558-1446337676 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004386 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 14:23:57.563023) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-01 14:23:57.563623) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-01 14:23:57.564205) ========= ========= Total master_lag: 0.20 =========