builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-066 starttime: 1468229644.87 results: success (0) buildid: 20160711010827 builduid: b4451fd79b08490c92abd273c7187717 revision: 1de829f2f1f03e23ca0159bee473d36b9989e62b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:04.870436) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:04.870926) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:04.871229) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:04.887500) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:04.887950) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-11 02:34:05-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 42.9M=0s 2016-07-11 02:34:05 (42.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.126360 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.029295) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.029656) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021038 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.079698) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.080056) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 1de829f2f1f03e23ca0159bee473d36b9989e62b --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 1de829f2f1f03e23ca0159bee473d36b9989e62b --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=82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-11 02:34:05,851 truncating revision to first 12 chars 2016-07-11 02:34:05,851 Setting DEBUG logging. 2016-07-11 02:34:05,851 attempt 1/10 2016-07-11 02:34:05,851 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/1de829f2f1f0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-11 02:34:06,156 unpacking tar archive at: fx-team-1de829f2f1f0/testing/mozharness/ program finished with exit code 0 elapsedTime=0.740880 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.833461) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.833784) ========= script_repo_revision: 1de829f2f1f03e23ca0159bee473d36b9989e62b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.834182) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.834446) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-11 02:34:05.841559) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-07-11 02:34:05.841923) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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=82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 02:34:06 INFO - MultiFileLogger online at 20160711 02:34:06 in /builds/slave/test 02:34:06 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 02:34:06 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:34:06 INFO - {'append_to_log': False, 02:34:06 INFO - 'base_work_dir': '/builds/slave/test', 02:34:06 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 02:34:06 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:34:06 INFO - 'branch': 'Fx-Team-Non-PGO', 02:34:06 INFO - 'buildbot_json_path': 'buildprops.json', 02:34:06 INFO - 'config_files': ('talos/linux_config.py',), 02:34:06 INFO - 'default_actions': ('clobber', 02:34:06 INFO - 'read-buildbot-config', 02:34:06 INFO - 'download-and-extract', 02:34:06 INFO - 'populate-webroot', 02:34:06 INFO - 'create-virtualenv', 02:34:06 INFO - 'install', 02:34:06 INFO - 'run-tests'), 02:34:06 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:34:06 INFO - 'download_minidump_stackwalk': True, 02:34:06 INFO - 'download_symbols': 'ondemand', 02:34:06 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 02:34:06 INFO - 'tooltool.py': '/tools/tooltool.py', 02:34:06 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 02:34:06 INFO - '/tools/misc-python/virtualenv.py')}, 02:34:06 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:34:06 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:34:06 INFO - 'installer_path': 'installer.exe', 02:34:06 INFO - 'log_level': 'info', 02:34:06 INFO - 'log_name': 'talos', 02:34:06 INFO - 'log_to_console': True, 02:34:06 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 02:34:06 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 02:34:06 INFO - 'opt_config_files': (), 02:34:06 INFO - 'pip_index': False, 02:34:06 INFO - 'sps_profile': False, 02:34:06 INFO - 'sps_profile_interval': 0, 02:34:06 INFO - 'suite': 'dromaeojs-e10s', 02:34:06 INFO - 'system_bits': '32', 02:34:06 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:34:06 INFO - 'title': 'talos-linux64-ix-066', 02:34:06 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:34:06 INFO - 'use_talos_json': True, 02:34:06 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:34:06 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:34:06 INFO - 'work_dir': 'build'} 02:34:06 INFO - ##### 02:34:06 INFO - ##### Running clobber step. 02:34:06 INFO - ##### 02:34:06 INFO - Running pre-action listener: _resource_record_pre_action 02:34:06 INFO - Running main action method: clobber 02:34:06 INFO - rmtree: /builds/slave/test/build 02:34:06 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:34:07 INFO - Running post-action listener: _resource_record_post_action 02:34:07 INFO - ##### 02:34:07 INFO - ##### Finished clobber step (success) 02:34:07 INFO - ##### 02:34:07 INFO - ##### 02:34:07 INFO - ##### Running read-buildbot-config step. 02:34:07 INFO - ##### 02:34:07 INFO - Running pre-action listener: _resource_record_pre_action 02:34:07 INFO - Running main action method: read_buildbot_config 02:34:07 INFO - Using buildbot properties: 02:34:07 INFO - { 02:34:07 INFO - "project": "", 02:34:07 INFO - "product": "firefox", 02:34:07 INFO - "script_repo_revision": "production", 02:34:07 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 02:34:07 INFO - "repository": "", 02:34:07 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 02:34:07 INFO - "buildid": "20160711010827", 02:34:07 INFO - "pgo_build": "False", 02:34:07 INFO - "basedir": "/builds/slave/test", 02:34:07 INFO - "buildnumber": 1439, 02:34:07 INFO - "slavename": "talos-linux64-ix-066", 02:34:07 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 02:34:07 INFO - "platform": "ubuntu64_hw", 02:34:07 INFO - "scheduler": "tests-fx-team-linux64-talos", 02:34:07 INFO - "branch": "fx-team", 02:34:07 INFO - "repo_path": "integration/fx-team", 02:34:07 INFO - "revision": "1de829f2f1f03e23ca0159bee473d36b9989e62b", 02:34:07 INFO - "stage_platform": "linux64", 02:34:07 INFO - "builduid": "b4451fd79b08490c92abd273c7187717", 02:34:07 INFO - "slavebuilddir": "test" 02:34:07 INFO - } 02:34:07 INFO - Found installer url https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 02:34:07 INFO - Running post-action listener: _resource_record_post_action 02:34:07 INFO - ##### 02:34:07 INFO - ##### Finished read-buildbot-config step (success) 02:34:07 INFO - ##### 02:34:07 INFO - ##### 02:34:07 INFO - ##### Running download-and-extract step. 02:34:07 INFO - ##### 02:34:07 INFO - Running pre-action listener: _resource_record_pre_action 02:34:07 INFO - Running main action method: download_and_extract 02:34:07 INFO - mkdir: /builds/slave/test/build/tests 02:34:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:07 INFO - https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 02:34:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 02:34:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 02:34:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:07 INFO - Downloaded 1361 bytes. 02:34:07 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 02:34:07 INFO - Using the following test package requirements: 02:34:07 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 02:34:07 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:34:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 02:34:07 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:34:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 02:34:07 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:34:07 INFO - u'jsshell-linux-x86_64.zip'], 02:34:07 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:34:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 02:34:07 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 02:34:07 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:34:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 02:34:07 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:34:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 02:34:07 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:34:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 02:34:07 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:34:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 02:34:07 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 02:34:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:07 INFO - https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 02:34:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 02:34:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 02:34:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:08 INFO - Downloaded 22735150 bytes. 02:34:08 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'] 02:34:08 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 02:34:10 INFO - Return code: 0 02:34:10 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 02:34:10 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')]} 02:34:10 INFO - https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 02:34:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 02:34:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 02:34:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:11 INFO - Downloaded 22735150 bytes. 02:34:11 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'] 02:34:11 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 02:34:12 INFO - Return code: 0 02:34: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')]} 02:34:12 INFO - https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 02:34:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 02:34:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 02:34:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:13 INFO - Downloaded 14403333 bytes. 02:34:13 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'] 02:34:13 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 02:34:13 INFO - Return code: 0 02:34:13 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')]} 02:34:13 INFO - https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 02:34:13 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 02:34:13 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 02:34:13 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OOI6Ot6wQhuGehkkWS-OaA/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 02:34:15 INFO - Downloaded 56659644 bytes. 02:34:15 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 02:34:15 INFO - mkdir: /builds/slave/test/properties 02:34:15 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:34:15 INFO - Writing to file /builds/slave/test/properties/build_url 02:34:15 INFO - Contents: 02:34:15 INFO - build_url:https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 02:34:15 INFO - Running post-action listener: _resource_record_post_action 02:34:15 INFO - Running post-action listener: set_extra_try_arguments 02:34:15 INFO - ##### 02:34:15 INFO - ##### Finished download-and-extract step (success) 02:34:15 INFO - ##### 02:34:15 INFO - ##### 02:34:15 INFO - ##### Running populate-webroot step. 02:34:15 INFO - ##### 02:34:15 INFO - Running pre-action listener: _resource_record_pre_action 02:34:15 INFO - Running main action method: populate_webroot 02:34:15 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 02:34:15 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 02:34:15 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 02:34:15 INFO - '--tppagecycles', 02:34:15 INFO - '7'], 02:34:15 INFO - 'tests': ['tsvgm']}}, 02:34:15 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['tresize', 'tcanvasmark']}, 02:34:15 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 02:34:15 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['dromaeo_css', 'kraken']}, 02:34:15 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 02:34:15 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:34:15 INFO - 'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:34:15 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:34:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:34:15 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:34:15 INFO - 'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['damp', 'tps']}, 02:34:15 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:34:15 INFO - 'tests': ['damp', 'tps']}, 02:34:15 INFO - 'g3': {'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['dromaeo_dom']}, 02:34:15 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:34:15 INFO - 'g4': {'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['basic_compositor_video']}, 02:34:15 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 02:34:15 INFO - 'other': {'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['a11yr', 02:34:15 INFO - 'ts_paint', 02:34:15 INFO - 'tpaint', 02:34:15 INFO - 'sessionrestore', 02:34:15 INFO - 'sessionrestore_no_auto_restore', 02:34:15 INFO - 'tabpaint']}, 02:34:15 INFO - 'other-e10s': {'tests': ['a11yr', 02:34:15 INFO - 'ts_paint', 02:34:15 INFO - 'tpaint', 02:34:15 INFO - 'sessionrestore', 02:34:15 INFO - 'sessionrestore_no_auto_restore', 02:34:15 INFO - 'tabpaint']}, 02:34:15 INFO - 'other-e10s_l64': {'tests': ['a11yr', 02:34:15 INFO - 'ts_paint', 02:34:15 INFO - 'tpaint', 02:34:15 INFO - 'sessionrestore', 02:34:15 INFO - 'sessionrestore_no_auto_restore', 02:34:15 INFO - 'tabpaint']}, 02:34:15 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 02:34:15 INFO - 'ts_paint', 02:34:15 INFO - 'tpaint', 02:34:15 INFO - 'sessionrestore', 02:34:15 INFO - 'sessionrestore_no_auto_restore', 02:34:15 INFO - 'tabpaint']}, 02:34:15 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['a11yr', 02:34:15 INFO - 'ts_paint', 02:34:15 INFO - 'tpaint', 02:34:15 INFO - 'sessionrestore', 02:34:15 INFO - 'sessionrestore_no_auto_restore', 02:34:15 INFO - 'tabpaint']}, 02:34:15 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['a11yr', 02:34:15 INFO - 'ts_paint', 02:34:15 INFO - 'tpaint', 02:34:15 INFO - 'sessionrestore', 02:34:15 INFO - 'sessionrestore_no_auto_restore', 02:34:15 INFO - 'tabpaint']}, 02:34:15 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['tsvgx', 02:34:15 INFO - 'tsvgr_opacity', 02:34:15 INFO - 'tart', 02:34:15 INFO - 'tscrollx', 02:34:15 INFO - 'cart']}, 02:34:15 INFO - 'svgr-e10s': {'tests': ['tsvgx', 02:34:15 INFO - 'tsvgr_opacity', 02:34:15 INFO - 'tart', 02:34:15 INFO - 'tscrollx', 02:34:15 INFO - 'cart']}, 02:34:15 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:34:15 INFO - 'talos_options': ['--disable-e10s'], 02:34:15 INFO - 'tests': ['tp5o']}, 02:34:15 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:34:15 INFO - 'tests': ['tp5o']}, 02:34:15 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:34:15 INFO - 'talos_options': ['--disable-e10s', 02:34:15 INFO - '--xperf_path', 02:34:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:34:15 INFO - 'tests': ['tp5n']}, 02:34:15 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:34:15 INFO - 'talos_options': ['--xperf_path', 02:34:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:34:15 INFO - 'tests': ['tp5n']}}, 02:34:15 INFO - 'talos.zip': {'path': '', 02:34:15 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 02:34:15 INFO - Running post-action listener: _resource_record_post_action 02:34:15 INFO - ##### 02:34:15 INFO - ##### Finished populate-webroot step (success) 02:34:15 INFO - ##### 02:34:15 INFO - ##### 02:34:15 INFO - ##### Running create-virtualenv step. 02:34:15 INFO - ##### 02:34:15 INFO - Running pre-action listener: _resource_record_pre_action 02:34:15 INFO - Running main action method: create_virtualenv 02:34:15 INFO - Creating virtualenv /builds/slave/test/build/venv 02:34:15 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 02:34:15 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 02:34:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:34:15 INFO - Using real prefix '/usr' 02:34:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:34:16 INFO - Installing distribute.............................................................................................................................................................................................done. 02:34:18 INFO - Installing pip.................done. 02:34:18 INFO - Return code: 0 02:34:18 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:34:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:18 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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:18 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 02:34:18 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 02:34:18 INFO - Using env: {'DISPLAY': ':0', 02:34:18 INFO - 'HOME': '/home/cltbld', 02:34:18 INFO - 'LANG': 'en_US.UTF-8', 02:34:18 INFO - 'LANGUAGE': 'en_US:en', 02:34:18 INFO - 'LOGNAME': 'cltbld', 02:34:18 INFO - 'MAIL': '/var/mail/cltbld', 02:34:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:18 INFO - 'MOZ_NO_REMOTE': '1', 02:34:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:18 INFO - 'NO_EM_RESTART': '1', 02:34:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:18 INFO - 'PWD': '/builds/slave/test', 02:34:18 INFO - 'SHELL': '/bin/bash', 02:34:18 INFO - 'SHLVL': '1', 02:34:18 INFO - 'TERM': 'linux', 02:34:18 INFO - 'TMOUT': '86400', 02:34:18 INFO - 'USER': 'cltbld', 02:34:18 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:18 INFO - '_': '/tools/buildbot/bin/python'} 02:34:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:18 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 02:34:18 INFO - Cleaning up... 02:34:18 INFO - Return code: 0 02:34:18 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 02:34:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:18 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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:18 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 02:34:18 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 02:34:18 INFO - Using env: {'DISPLAY': ':0', 02:34:18 INFO - 'HOME': '/home/cltbld', 02:34:18 INFO - 'LANG': 'en_US.UTF-8', 02:34:18 INFO - 'LANGUAGE': 'en_US:en', 02:34:18 INFO - 'LOGNAME': 'cltbld', 02:34:18 INFO - 'MAIL': '/var/mail/cltbld', 02:34:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:18 INFO - 'MOZ_NO_REMOTE': '1', 02:34:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:18 INFO - 'NO_EM_RESTART': '1', 02:34:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:18 INFO - 'PWD': '/builds/slave/test', 02:34:18 INFO - 'SHELL': '/bin/bash', 02:34:18 INFO - 'SHLVL': '1', 02:34:18 INFO - 'TERM': 'linux', 02:34:18 INFO - 'TMOUT': '86400', 02:34:18 INFO - 'USER': 'cltbld', 02:34:18 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:18 INFO - '_': '/tools/buildbot/bin/python'} 02:34:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:18 INFO - Downloading/unpacking psutil>=3.1.1 02:34:18 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 02:34:18 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 02:34:18 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 02:34:18 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 02:34:18 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 02:34:18 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 02:34:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:34:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:34:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:34:20 INFO - Installing collected packages: psutil 02:34:20 INFO - Running setup.py install for psutil 02:34:20 INFO - building 'psutil._psutil_linux' extension 02:34:20 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 02:34:21 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 02:34:21 INFO - building 'psutil._psutil_posix' extension 02:34:21 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 02:34:21 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 02:34:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:34:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:34:21 INFO - Successfully installed psutil 02:34:21 INFO - Cleaning up... 02:34:21 INFO - Return code: 0 02:34:21 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 02:34:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:21 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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:21 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 02:34:21 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 02:34:21 INFO - Using env: {'DISPLAY': ':0', 02:34:21 INFO - 'HOME': '/home/cltbld', 02:34:21 INFO - 'LANG': 'en_US.UTF-8', 02:34:21 INFO - 'LANGUAGE': 'en_US:en', 02:34:21 INFO - 'LOGNAME': 'cltbld', 02:34:21 INFO - 'MAIL': '/var/mail/cltbld', 02:34:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:21 INFO - 'MOZ_NO_REMOTE': '1', 02:34:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:21 INFO - 'NO_EM_RESTART': '1', 02:34:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:21 INFO - 'PWD': '/builds/slave/test', 02:34:21 INFO - 'SHELL': '/bin/bash', 02:34:21 INFO - 'SHLVL': '1', 02:34:21 INFO - 'TERM': 'linux', 02:34:21 INFO - 'TMOUT': '86400', 02:34:21 INFO - 'USER': 'cltbld', 02:34:21 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:21 INFO - '_': '/tools/buildbot/bin/python'} 02:34:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:21 INFO - Downloading/unpacking mozsystemmonitor==0.3 02:34:21 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 02:34:21 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 02:34:21 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 02:34:21 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 02:34:21 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 02:34:21 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 02:34:23 INFO - Downloading mozsystemmonitor-0.3.tar.gz 02:34:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:34:23 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 02:34:23 INFO - Installing collected packages: mozsystemmonitor 02:34:23 INFO - Running setup.py install for mozsystemmonitor 02:34:23 INFO - Successfully installed mozsystemmonitor 02:34:23 INFO - Cleaning up... 02:34:23 INFO - Return code: 0 02:34:23 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 02:34:23 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')]} 02:34:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:23 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')]} 02:34:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:23 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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:23 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 02:34:23 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 02:34:23 INFO - Using env: {'DISPLAY': ':0', 02:34:23 INFO - 'HOME': '/home/cltbld', 02:34:23 INFO - 'LANG': 'en_US.UTF-8', 02:34:23 INFO - 'LANGUAGE': 'en_US:en', 02:34:23 INFO - 'LOGNAME': 'cltbld', 02:34:23 INFO - 'MAIL': '/var/mail/cltbld', 02:34:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:23 INFO - 'MOZ_NO_REMOTE': '1', 02:34:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:23 INFO - 'NO_EM_RESTART': '1', 02:34:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:23 INFO - 'PWD': '/builds/slave/test', 02:34:23 INFO - 'SHELL': '/bin/bash', 02:34:23 INFO - 'SHLVL': '1', 02:34:23 INFO - 'TERM': 'linux', 02:34:23 INFO - 'TMOUT': '86400', 02:34:23 INFO - 'USER': 'cltbld', 02:34:23 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:23 INFO - '_': '/tools/buildbot/bin/python'} 02:34:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:23 INFO - Downloading/unpacking jsonschema==2.5.1 02:34:23 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 02:34:23 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 02:34:23 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 02:34:23 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 02:34:23 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 02:34:23 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 02:34:25 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:34:25 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 02:34:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:34:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:34:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:34:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:34:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:34:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:34:26 INFO - Downloading functools32-3.2.3-2.tar.gz 02:34:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:34:26 INFO - warning: no files found matching '*.txt' 02:34:26 INFO - no previously-included directories found matching 'build' 02:34:26 INFO - no previously-included directories found matching 'dist' 02:34:26 INFO - no previously-included directories found matching '.git*' 02:34:26 INFO - Installing collected packages: jsonschema, functools32 02:34:26 INFO - Running setup.py install for functools32 02:34:26 INFO - warning: no files found matching '*.txt' 02:34:26 INFO - no previously-included directories found matching 'build' 02:34:26 INFO - no previously-included directories found matching 'dist' 02:34:26 INFO - no previously-included directories found matching '.git*' 02:34:26 INFO - Successfully installed jsonschema functools32 02:34:26 INFO - Cleaning up... 02:34:26 INFO - Return code: 0 02:34:26 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:34: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')]} 02:34:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34: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')]} 02:34:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 02:34:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 02:34:26 INFO - Using env: {'DISPLAY': ':0', 02:34:26 INFO - 'HOME': '/home/cltbld', 02:34:26 INFO - 'LANG': 'en_US.UTF-8', 02:34:26 INFO - 'LANGUAGE': 'en_US:en', 02:34:26 INFO - 'LOGNAME': 'cltbld', 02:34:26 INFO - 'MAIL': '/var/mail/cltbld', 02:34:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:26 INFO - 'MOZ_NO_REMOTE': '1', 02:34:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:26 INFO - 'NO_EM_RESTART': '1', 02:34:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:26 INFO - 'PWD': '/builds/slave/test', 02:34:26 INFO - 'SHELL': '/bin/bash', 02:34:26 INFO - 'SHLVL': '1', 02:34:26 INFO - 'TERM': 'linux', 02:34:26 INFO - 'TMOUT': '86400', 02:34:26 INFO - 'USER': 'cltbld', 02:34:26 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:26 INFO - '_': '/tools/buildbot/bin/python'} 02:34:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:26 INFO - Downloading/unpacking blobuploader==1.2.4 02:34:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:34:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:34:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:34:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:34:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:34:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:34:28 INFO - Downloading blobuploader-1.2.4.tar.gz 02:34:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:34:28 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:34:28 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 02:34:28 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 02:34:28 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 02:34:28 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 02:34:28 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 02:34:28 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 02:34:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:34:28 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:34:28 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 02:34:28 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 02:34:28 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 02:34:28 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 02:34:28 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 02:34:28 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 02:34:29 INFO - Downloading docopt-0.6.1.tar.gz 02:34:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:34:29 INFO - Installing collected packages: blobuploader, requests, docopt 02:34:29 INFO - Running setup.py install for blobuploader 02:34:29 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:34:29 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:34:29 INFO - Running setup.py install for requests 02:34:29 INFO - Running setup.py install for docopt 02:34:29 INFO - Successfully installed blobuploader requests docopt 02:34:29 INFO - Cleaning up... 02:34:29 INFO - Return code: 0 02:34:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:34:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:29 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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:29 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 02:34:29 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 02:34:29 INFO - Using env: {'DISPLAY': ':0', 02:34:29 INFO - 'HOME': '/home/cltbld', 02:34:29 INFO - 'LANG': 'en_US.UTF-8', 02:34:29 INFO - 'LANGUAGE': 'en_US:en', 02:34:29 INFO - 'LOGNAME': 'cltbld', 02:34:29 INFO - 'MAIL': '/var/mail/cltbld', 02:34:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:29 INFO - 'MOZ_NO_REMOTE': '1', 02:34:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:29 INFO - 'NO_EM_RESTART': '1', 02:34:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:29 INFO - 'PWD': '/builds/slave/test', 02:34:29 INFO - 'SHELL': '/bin/bash', 02:34:29 INFO - 'SHLVL': '1', 02:34:29 INFO - 'TERM': 'linux', 02:34:29 INFO - 'TMOUT': '86400', 02:34:29 INFO - 'USER': 'cltbld', 02:34:29 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:29 INFO - '_': '/tools/buildbot/bin/python'} 02:34:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:34:30 INFO - Running setup.py (path:/tmp/pip-02rX0r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:34:30 INFO - Running setup.py (path:/tmp/pip-B1Nrp_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:34:30 INFO - Running setup.py (path:/tmp/pip-WkxXgN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:34:30 INFO - Running setup.py (path:/tmp/pip-uwfd91-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:34:30 INFO - Running setup.py (path:/tmp/pip-JRCr6Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:34:30 INFO - Running setup.py (path:/tmp/pip-4UnXx1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:34:30 INFO - Running setup.py (path:/tmp/pip-KGoW2p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:34:30 INFO - Running setup.py (path:/tmp/pip-ZT3w8_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:34:30 INFO - Running setup.py (path:/tmp/pip-sp2_fW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:34:30 INFO - Running setup.py (path:/tmp/pip-vVapte-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:34:30 INFO - Running setup.py (path:/tmp/pip-gualc_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:34:30 INFO - Running setup.py (path:/tmp/pip-zo9IBS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:34:30 INFO - Running setup.py (path:/tmp/pip-4C9cyZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:34:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:34:30 INFO - Running setup.py (path:/tmp/pip-AfpZ__-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:34:31 INFO - Running setup.py (path:/tmp/pip-uRDW1a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:34:31 INFO - Running setup.py (path:/tmp/pip-liy1EA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:34:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:34:31 INFO - Running setup.py (path:/tmp/pip-wMeogJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:34:31 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:34:31 INFO - Running setup.py install for manifestparser 02:34:31 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:34:31 INFO - Running setup.py install for mozcrash 02:34:31 INFO - Running setup.py install for mozdebug 02:34:31 INFO - Running setup.py install for mozdevice 02:34:31 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 02:34:31 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:34:31 INFO - Running setup.py install for mozfile 02:34:31 INFO - Running setup.py install for mozhttpd 02:34:31 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:34:31 INFO - Running setup.py install for mozinfo 02:34:31 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:34:31 INFO - Running setup.py install for mozInstall 02:34:32 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Running setup.py install for mozleak 02:34:32 INFO - Running setup.py install for mozlog 02:34:32 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Running setup.py install for moznetwork 02:34:32 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Running setup.py install for mozprocess 02:34:32 INFO - Running setup.py install for mozprofile 02:34:32 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Running setup.py install for mozrunner 02:34:32 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:34:32 INFO - Running setup.py install for mozscreenshot 02:34:32 INFO - Running setup.py install for moztest 02:34:32 INFO - Running setup.py install for mozversion 02:34:33 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:34:33 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:34:33 INFO - Cleaning up... 02:34:33 INFO - Return code: 0 02:34:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:34:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:33 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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:33 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 02:34:33 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 02:34:33 INFO - Using env: {'DISPLAY': ':0', 02:34:33 INFO - 'HOME': '/home/cltbld', 02:34:33 INFO - 'LANG': 'en_US.UTF-8', 02:34:33 INFO - 'LANGUAGE': 'en_US:en', 02:34:33 INFO - 'LOGNAME': 'cltbld', 02:34:33 INFO - 'MAIL': '/var/mail/cltbld', 02:34:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:33 INFO - 'MOZ_NO_REMOTE': '1', 02:34:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:33 INFO - 'NO_EM_RESTART': '1', 02:34:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:33 INFO - 'PWD': '/builds/slave/test', 02:34:33 INFO - 'SHELL': '/bin/bash', 02:34:33 INFO - 'SHLVL': '1', 02:34:33 INFO - 'TERM': 'linux', 02:34:33 INFO - 'TMOUT': '86400', 02:34:33 INFO - 'USER': 'cltbld', 02:34:33 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:33 INFO - '_': '/tools/buildbot/bin/python'} 02:34:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:34:33 INFO - Running setup.py (path:/tmp/pip-yHdhd4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:34:33 INFO - Running setup.py (path:/tmp/pip-xKbu63-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:34:33 INFO - Running setup.py (path:/tmp/pip-bjBOu_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:34:33 INFO - Running setup.py (path:/tmp/pip-FEjqtp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:34:33 INFO - Running setup.py (path:/tmp/pip-9ZGuTs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:34:33 INFO - Running setup.py (path:/tmp/pip-4nr220-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:34:33 INFO - Running setup.py (path:/tmp/pip-5Ocw81-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:34:33 INFO - Running setup.py (path:/tmp/pip-M8F2vw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:34:33 INFO - Running setup.py (path:/tmp/pip-pKhgnh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:34:33 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)) 02:34:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:34:33 INFO - Running setup.py (path:/tmp/pip-ae0gFb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:34:34 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)) 02:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:34:34 INFO - Running setup.py (path:/tmp/pip-SGIwxS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:34:34 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)) 02:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:34:34 INFO - Running setup.py (path:/tmp/pip-3dOdUg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:34:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 02:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:34:34 INFO - Running setup.py (path:/tmp/pip-v7FdJD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:34:34 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)) 02:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:34:34 INFO - Running setup.py (path:/tmp/pip-1pyqoZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:34:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 02:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:34:34 INFO - Running setup.py (path:/tmp/pip-ReMxcN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:34:34 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)) 02:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:34:34 INFO - Running setup.py (path:/tmp/pip-ey3DCy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:34:34 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)) 02:34:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:34:34 INFO - Running setup.py (path:/tmp/pip-wVx1BY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:34:34 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)) 02:34:34 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)) 02:34:34 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)) 02:34:34 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)) 02:34:34 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)) 02:34:34 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)) 02:34:34 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:34:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:34:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:34:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:34:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:34:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:34:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:34:36 INFO - Downloading blessings-1.6.tar.gz 02:34:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:34:36 INFO - Installing collected packages: blessings 02:34:36 INFO - Running setup.py install for blessings 02:34:36 INFO - Successfully installed blessings 02:34:36 INFO - Cleaning up... 02:34:36 INFO - Return code: 0 02:34:36 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:34:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:34:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:34:36 INFO - Reading from file tmpfile_stdout 02:34:36 INFO - Current package versions: 02:34:36 INFO - argparse == 1.2.1 02:34:36 INFO - blessings == 1.6 02:34:36 INFO - blobuploader == 1.2.4 02:34:36 INFO - docopt == 0.6.1 02:34:36 INFO - functools32 == 3.2.3-2 02:34:36 INFO - jsonschema == 2.5.1 02:34:36 INFO - manifestparser == 1.1 02:34:36 INFO - mozInstall == 1.12 02:34:36 INFO - mozcrash == 0.17 02:34:36 INFO - mozdebug == 0.1 02:34:36 INFO - mozdevice == 0.48 02:34:36 INFO - mozfile == 1.2 02:34:36 INFO - mozhttpd == 0.7 02:34:36 INFO - mozinfo == 0.9 02:34:36 INFO - mozleak == 0.1 02:34:36 INFO - mozlog == 3.2 02:34:36 INFO - moznetwork == 0.27 02:34:36 INFO - mozprocess == 0.23 02:34:36 INFO - mozprofile == 0.28 02:34:36 INFO - mozrunner == 6.12 02:34:36 INFO - mozscreenshot == 0.1 02:34:36 INFO - mozsystemmonitor == 0.3 02:34:36 INFO - moztest == 0.7 02:34:36 INFO - mozversion == 1.4 02:34:36 INFO - psutil == 3.1.1 02:34:36 INFO - requests == 1.2.3 02:34:36 INFO - wsgiref == 0.1.2 02:34:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:34: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')]} 02:34:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34: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')]} 02:34:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:36 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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:36 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 02:34:36 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 02:34:36 INFO - Using env: {'DISPLAY': ':0', 02:34:36 INFO - 'HOME': '/home/cltbld', 02:34:36 INFO - 'LANG': 'en_US.UTF-8', 02:34:36 INFO - 'LANGUAGE': 'en_US:en', 02:34:36 INFO - 'LOGNAME': 'cltbld', 02:34:36 INFO - 'MAIL': '/var/mail/cltbld', 02:34:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:36 INFO - 'MOZ_NO_REMOTE': '1', 02:34:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:36 INFO - 'NO_EM_RESTART': '1', 02:34:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:36 INFO - 'PWD': '/builds/slave/test', 02:34:36 INFO - 'SHELL': '/bin/bash', 02:34:36 INFO - 'SHLVL': '1', 02:34:36 INFO - 'TERM': 'linux', 02:34:36 INFO - 'TMOUT': '86400', 02:34:36 INFO - 'USER': 'cltbld', 02:34:36 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:36 INFO - '_': '/tools/buildbot/bin/python'} 02:34:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 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)) 02:34:37 INFO - Cleaning up... 02:34:37 INFO - Return code: 0 02:34:37 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:34:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:34:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:34:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:34:37 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 0x1728030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x188b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1957400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, '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': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', '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 02:34:37 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 02:34:37 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 02:34:37 INFO - Using env: {'DISPLAY': ':0', 02:34:37 INFO - 'HOME': '/home/cltbld', 02:34:37 INFO - 'LANG': 'en_US.UTF-8', 02:34:37 INFO - 'LANGUAGE': 'en_US:en', 02:34:37 INFO - 'LOGNAME': 'cltbld', 02:34:37 INFO - 'MAIL': '/var/mail/cltbld', 02:34:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:37 INFO - 'MOZ_NO_REMOTE': '1', 02:34:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:37 INFO - 'NO_EM_RESTART': '1', 02:34:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:37 INFO - 'PWD': '/builds/slave/test', 02:34:37 INFO - 'SHELL': '/bin/bash', 02:34:37 INFO - 'SHLVL': '1', 02:34:37 INFO - 'TERM': 'linux', 02:34:37 INFO - 'TMOUT': '86400', 02:34:37 INFO - 'USER': 'cltbld', 02:34:37 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:37 INFO - '_': '/tools/buildbot/bin/python'} 02:34:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:34:37 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 02:34:37 INFO - Cleaning up... 02:34:37 INFO - Return code: 0 02:34:37 INFO - Running post-action listener: _resource_record_post_action 02:34:37 INFO - Running post-action listener: _start_resource_monitoring 02:34:37 INFO - Starting resource monitoring. 02:34:37 INFO - ##### 02:34:37 INFO - ##### Finished create-virtualenv step (success) 02:34:37 INFO - ##### 02:34:37 INFO - ##### 02:34:37 INFO - ##### Running install step. 02:34:37 INFO - ##### 02:34:37 INFO - Running pre-action listener: _resource_record_pre_action 02:34:37 INFO - Running main action method: install 02:34:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:34:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:34:37 INFO - Reading from file tmpfile_stdout 02:34:37 INFO - Detecting whether we're running mozinstall >=1.0... 02:34:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:34:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:34:37 INFO - Reading from file tmpfile_stdout 02:34:37 INFO - Output received: 02:34:37 INFO - Usage: mozinstall [options] installer 02:34:37 INFO - Options: 02:34:37 INFO - -h, --help show this help message and exit 02:34:37 INFO - -d DEST, --destination=DEST 02:34:37 INFO - Directory to install application into. [default: 02:34:37 INFO - "/builds/slave/test"] 02:34:37 INFO - --app=APP Application being installed. [default: firefox] 02:34:37 INFO - mkdir: /builds/slave/test/build/application 02:34:37 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'] 02:34:37 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 02:34:53 INFO - Reading from file tmpfile_stdout 02:34:53 INFO - Output received: 02:34:53 INFO - /builds/slave/test/build/application/firefox/firefox 02:34:53 INFO - Running post-action listener: _resource_record_post_action 02:34:53 INFO - ##### 02:34:53 INFO - ##### Finished install step (success) 02:34:53 INFO - ##### 02:34:53 INFO - ##### 02:34:53 INFO - ##### Running run-tests step. 02:34:53 INFO - ##### 02:34:53 INFO - Running pre-action listener: _resource_record_pre_action 02:34:53 INFO - Running main action method: run_tests 02:34:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:34:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:34:53 INFO - Python 2.7.3 02:34:53 INFO - Return code: 0 02:34:53 INFO - grabbing minidump binary from tooltool 02:34:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 02:34:53 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 0x19e6570>, '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 0x19e7470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e7900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:34:53 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 02:34:53 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 02:34:53 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 02:34:54 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:34:54 INFO - Return code: 0 02:34:54 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 02:34:54 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:34:54 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:34:54 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 02:34:54 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:34:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 02:34:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-066 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 02:34:54 INFO - Using env: {'DISPLAY': ':0', 02:34:54 INFO - 'HOME': '/home/cltbld', 02:34:54 INFO - 'LANG': 'en_US.UTF-8', 02:34:54 INFO - 'LANGUAGE': 'en_US:en', 02:34:54 INFO - 'LOGNAME': 'cltbld', 02:34:54 INFO - 'MAIL': '/var/mail/cltbld', 02:34:54 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:34:54 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 02:34:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:34:54 INFO - 'MOZ_NO_REMOTE': '1', 02:34:54 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:34:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:34:54 INFO - 'NO_EM_RESTART': '1', 02:34:54 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:34:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:34:54 INFO - 'PWD': '/builds/slave/test', 02:34:54 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:34:54 INFO - 'SHELL': '/bin/bash', 02:34:54 INFO - 'SHLVL': '1', 02:34:54 INFO - 'TERM': 'linux', 02:34:54 INFO - 'TMOUT': '86400', 02:34:54 INFO - 'USER': 'cltbld', 02:34:54 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584', 02:34:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:34:54 INFO - '_': '/tools/buildbot/bin/python'} 02:34:54 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 02:34:54 INFO - mozversion application_buildid: 20160711010827 02:34:54 INFO - mozversion application_changeset: 1de829f2f1f03e23ca0159bee473d36b9989e62b 02:34:54 INFO - mozversion application_display_name: Nightly 02:34:54 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:34:54 INFO - mozversion application_name: Firefox 02:34:54 INFO - mozversion application_remotingname: firefox 02:34:54 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 02:34:54 INFO - mozversion application_vendor: Mozilla 02:34:54 INFO - mozversion application_version: 50.0a1 02:34:54 INFO - mozversion platform_buildid: 20160711010827 02:34:54 INFO - mozversion platform_changeset: 1de829f2f1f03e23ca0159bee473d36b9989e62b 02:34:54 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 02:34:54 INFO - mozversion platform_version: 50.0a1 02:34:54 INFO - using testdate: 1468229694 02:34:54 INFO - actual date: 1468229694 02:34:54 INFO - starting webserver on 'localhost:39423' 02:34:54 INFO - SUITE-START | Running 2 tests 02:34:54 INFO - TEST-START | dromaeo_css 02:34:54 INFO - operating with platform_type : linux_ 02:34:54 INFO - Initialising browser for dromaeo_css test... 02:34:54 INFO - TEST-INFO | started process 22138 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpw52egu/profile http://localhost:39423/getInfo.html) 02:34:59 INFO - PROCESS | 22138 | __metrics Screen width/height:1600/1200 02:34:59 INFO - PROCESS | 22138 | colorDepth:24 02:34:59 INFO - PROCESS | 22138 | Browser inner width/height: 1024/697 02:34:59 INFO - PROCESS | 22138 | __metrics 02:35:00 ERROR - PROCESS | 22138 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2964: TypeError: this.tabs is undefined 02:35:01 INFO - TEST-INFO | 22138: exit 0 02:35:01 INFO - Browser initialized. 02:35:01 INFO - Running cycle 1/1 for dromaeo_css test... 02:35:01 INFO - TEST-INFO | started process 22258 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpw52egu/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:35:13 INFO - PROCESS | 22258 | RSS: Main: 168935424 02:35:13 INFO - PROCESS | 22258 | 02:36:02 INFO - PROCESS | 22258 | 1468229762666 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] 02:38:14 INFO - PROCESS | 22258 | Cycle 1(1): loaded http://localhost:39423/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39423/tests/dromaeo/cssquery-ext.html) 02:38:15 INFO - PROCESS | 22258 | RSS: Main: 171372544 02:38:15 INFO - PROCESS | 22258 | 02:41:18 INFO - PROCESS | 22258 | Cycle 1(1): loaded http://localhost:39423/tests/dromaeo/cssquery-ext.html (next: http://localhost:39423/tests/dromaeo/cssquery-jquery.html) 02:41:18 INFO - PROCESS | 22258 | RSS: Main: 167944192 02:41:18 INFO - PROCESS | 22258 | 02:44:20 INFO - PROCESS | 22258 | Cycle 1(1): loaded http://localhost:39423/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39423/tests/dromaeo/cssquery-mootools.html) 02:44:21 INFO - PROCESS | 22258 | RSS: Main: 172077056 02:44:21 INFO - PROCESS | 22258 | 02:47:23 INFO - PROCESS | 22258 | Cycle 1(1): loaded http://localhost:39423/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39423/tests/dromaeo/cssquery-prototype.html) 02:47:24 INFO - PROCESS | 22258 | RSS: Main: 167256064 02:47:24 INFO - PROCESS | 22258 | 02:50:26 INFO - PROCESS | 22258 | Cycle 1(1): loaded http://localhost:39423/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39423/tests/dromaeo/cssquery-yui.html) 02:50:27 INFO - PROCESS | 22258 | RSS: Main: 168681472 02:50:27 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | Cycle 1(1): loaded http://localhost:39423/tests/dromaeo/cssquery-yui.html (next: http://localhost:39423/tests/dromaeo/cssquery-dojo.html) 02:53:30 INFO - PROCESS | 22258 | RSS: Main: 170348544 02:53:30 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | __start_tp_report 02:53:30 INFO - PROCESS | 22258 | _x_x_mozilla_page_load 02:53:30 INFO - PROCESS | 22258 | _x_x_mozilla_page_load_details 02:53:30 INFO - PROCESS | 22258 | |i|pagename|runs| 02:53:30 INFO - PROCESS | 22258 | |0;dojo.html;2568.3707491664545;2568.5761849294868;2569.2292312306304;2606.4135569496875;2610.895564177433;4648.907021859561;4671.766411679415;4701.294805779135;4716.198246298129;4756.048790241953;4575.633949284058;4604.654650901179;4612.8385506507275;4643.976780116103;4650.209464391053;4228.809703563347;4312.28847240205;4343.131373725252;4364.388985542027;4365.585269399402;259.2516324238469;4246.490421149467;4302.591253830897;4320.351947207928;4329.7618630975285;4235.788210589458;4260.893477663052;4269.423627810268;4305.590968857953;4321.395004699345;4190.413342132104;4253.319468884994;4270.0605866709275;4297.871063868089;4345.022369966764;4191.874243772691;4251.659867210616;4261.552536983634;4271.9572804271875;4273.893152671208;4601.240795268776;4619.907601847978;4636.768161591907;4662.230731929228;4697.7181369117625;4835.468098509161;4898.90202195954;4944.653874228806;4953.0836795192645;4964.60283177345;4943.159662857287;4980.576650984671;4982.626303027288;5000.599952003868;5035.093683137034;4671.953280467186;4683.6721429500285;4684.367610372624;4692.1554120258;4724.858254252413;4956.776945037482;5005.499450055038;5042.9747851261245;5114.872128196825;5160.225966105039;4865.489123642037;4893.877653058702;4895.583875370633;4925.704457732548;4928;4945.085159245551;4946;4954.058728841508;4966.553010229097;4971.651984361132;4776.593989510861;4839.854804355875;4869.975650121727;4901.779419926112;4955.157623204064;4757.286407038971;4809.591184749265;4884.169691152512;4886.193778026657;4892.510748925079;4213.073123912734;4221.894452638647;4228.9788551057045;4257.87226383209;4260.659147268211;3609.296187243462;3617;3639.836207370675;3657.1040095176318;3685.502457168248;4332.0469496710675;4346.543612920661;4348.978255108767;4349.978250108729;4386;4897;4947.134251506044;4952.653314267966;4962.925556116661;4987.875303117378;4349.217140914602;4376.234159022159;4385.890352741207;4388.626966707801;4401.6478681705385;4467.15124126415;4496.685232033727;4502;4549.226631472658;4570.314452832102;4596;4597.287420449702;4720.433547974197;4732.361131247238;4732.716037037789;4881.829135980223;4901.068796928572;4902.338184345211;4914.434839993446;4967.354243948408;4584.266517357207;4624.560666736655;4635.281531362644;4641.071785642817;4683.227267500961;4726.338312636302;4832.1543729846435;4836.081144582518;4871.683340582851;4922.729249891147;5022.271770593316;5022.949770502249;5024.196128619549;5029.949700502948;5054.342935418372;4864.148773964472;4877.487863774252;4882.707037577757;4898.191798353232;4907.68100073494;4737.9052418952115;4744.667873248839;4825.445073816556;4853.708777473222;4921.778519966681;4615.838445654386;4679.532046795293;4749.738764367855;4758.571728544448;4778.259369797687;4892.65751397413;4894.2658601210105;4900.4854490278;4901.044296362175;4941.43173535048;4638.837640682695;4726.031163611383;4777.4267087949665;4780.020095880405;4788.473267940593 02:53:30 INFO - PROCESS | 22258 | |1;ext.html;551.4568150371883;552.1607157121175;558.4499268220802;561.7809054468755;580.9244798176236;34776.30447391054;38393.616063839356;38653.61346386535;38668;38741.61258387419;38181;38976;39026.4146037809;39082.21835563287;39161.804190979004;7481.6259187040705;7741.22587741227;7776.883346749803;7778.299953004229;7802.375809935192;7731.342835858959;7802.64888080035;7806.60966951653;7815;7829.295363417291;7824.882626760603;7834.216578342149;7853.528788272693;7878.409119316074;7887.408444366667;7812.843743125162;7822.139564647884;7844.803879902991;7856.725014624518;7862.724804631867;7745.883811742829;7799.805004874924;7803.414743894231;7822.6088695564995;7862.449628526006;36393.45409818855;36750.81624591887;36780.080497987496;36804;36942.076448088745;2836.404355085414;3156.684331566848;3209.5988001499813;3325.8503367348526;3357.6474470180524;27165.1850444487;27477.45045099107;27480.17559473219;27707.722922770718;27930.3017424564;3113.9532907006187;3115.18740808458;3137.51368537877;3183.9840800795846;3210.357928414303;267601;268381;269834;269953;270505;31475.685243147276;45504.317435238496;45740;45773.54226457759;45903.77048114738;31844.36311273808;33862.32275354528;33924;33971.49042764361;34028;11961.700957476132;11961.880381196077;12066.69833254158;12084.818727719092;12099.637010889688;11137.164712646583;11201.21591488588;11216.66350009501;11217.495212715285;11249.437528123724;7816.804579885435;7857.253560911704;7881.290683838367;7951;7970.920290797134;3141.0733833519166;3151.936961260808;3168.3188114555483;3176.3170918252226;3176.7617428692943;864.3776480933718;886.6187539358009;899.8875140607424;987.8468837330225;1000.7047920863363;27672.723272767416;28005;28095.43809123847;28097.578536321973;28724.994625188017;890.9866352004725;930.5021813329971;935.4761333653177;960.6061514778908;985.1330828870548;12971;13192.802107968197;13359.866401335863;13447.32763361828;13470.663233419047;404530;410464;410521;410592;410930;44745.55254447479;45974.77012614982;46040.53959460429;46137.538624614;46147;1137.2607804926863;1198.0655089030397;1215.5867005218267;1219.3049961522024;1226.9325187114973;24886.128985485422;25109.372265693502;25350.366240844127;25693.743062569883;26014.34964125912;39788.80105599453;40648.187036259704;40725.389119162646;40742.59257407388;40789.38815917823;357745;367242.14652487036;368832;370002;372367;24022.15922442706;24280.150194743805;24316;24335.513289733753;24351.391215219763;39105.608943911335;39823;40011.79994100011;40392.79803600963;40824.59175408208;34508;34543.827280863436;34843.477347839296;34999.475007875415;35364.115897102776;33019.83490082534;33092.669073308956;33330.83334583312;33506.162345940575;33854.153646158054;33917.66082339145;34460.13849653779;36612.450813238356;37104.257914841015;37292.627073728916;31613.8419307902;32957;33067.50398744069;33467.497987530696;33573.32853342968;24602.50794984126;25668.486630267664;25870;25965.6105158419;25990.48019039571 02:53:30 INFO - PROCESS | 22258 | |2;jquery.html;357.4959307376599;360.2650592790707;364.4496809817176;379.0334646651039;380.5604526771578;16099.35602575897;16382.344706211752;17649;17666.646667066652;17679.29282828687;16129.596760081004;16324.347026118941;16891.23989420476;16905.661886762256;16973;5106.106431374504;5185.481451854822;5268.157094864822;5272.604554658396;5275.235090911835;5119.641625086246;5180.507851754096;5193.870153246161;5198.792048318062;5221.71280579568;5353.330833645794;5406.810761623344;5407.567394608422;5409.24270602116;5414.052540805363;5223.791048358061;5293.364796224459;5350.5452036576935;5359.5444387227135;5415.512603865671;5190.532852043297;5210.426853046162;5215.6609820361555;5269.394019687708;5327.493888080626;12302.81545776814;12313.322767247797;17097.059661718602;20841.37475875711;21493.355199344045;1914.3586898389055;1957.5595491014408;2010.3466373428548;2081.6669332906663;2380.845290034349;9047;10000.549975251131;12264.509419623204;13176.077674562785;13439.059265851394;1645.7449095390234;1729.4292883348464;1751.5270876863303;1779.5729025034027;1823.632275793155;55761.44238557603;62789.68605156945;63507.36492635061;65833.67083164601;69664.65167674179;9257.537123143817;9461.668841590512;9894.604215831287;9930.05664461875;9938.354006989523;13285.800712989312;13332.466701332032;13348.46606135763;13401.731965360834;13497.527586534621;6588.275289718127;6624.171978502687;6788.9660551696925;6880.483963702743;7078.893816592756;6449.451796597248;6466.288708242089;6524.575902566318;6552.443042341454;6670.132882725312;4102.753834769924;4152.979235103805;4171.290880550314;4210.715731701799;4239.427677263591;1763;1793.2289115680383;1793.7757780277466;1803.1164729282818;1833.3399976008627;847.8130617136059;880.7049638371218;913.2055112052424;938.7934654376027;971.9562619682131;15548.611284717972;16868.32526698943;17519.386821461187;17584.912075439795;17609.119544023004;819.2135549872189;822.4414734079006;857.8198578298502;873.7335112790532;918.5361392496746;8971.775705607412;9647.614095436104;9655.806883862284;9715.319927605;9924.652637157666;370130;374188;379423;379464;380189;70277;70982;73887.63056184792;78071.2192878064;78988.21011789923;918.9172974432333;941.9152276295166;953.2850362228329;986.0730912941812;987.4223579206244;15817.841821582097;15995.360185592446;16028.11845348517;16033.438829640907;16486.422975195812;37494.43758343682;37854.24291514099;37906.241875162894;38061;38844;45509.31736023896;51631.74184129055;51747;51758;51784;7248.710051597877;7295.124585049828;7330.450216233698;7336.156342020736;7460.3658689012045;8040.718574849852;10885.836712449478;11615.245009074382;11670.299782012768;12099.33453660022;9062.954685226532;9441.763955901157;9792.216622670026;10086.8486972694;10099.596016159272;9811.215102791903;10205.795884082425;10262.692119236435;10334.5349459273;10363.84454233172;9965.202783777135;10309.536070876678;10584.89415105839;10654.254202205771;10705.518251678537;7215.025971493781;7232.493725439379;7281.235470275757;7310.305520975498;7407.8148046299275;9952.850707239253;10352.53413596405;10395.532201050819;10498.370097794157;10631 02:53:30 INFO - PROCESS | 22258 | |3;mootools.html;1361.441808858368;1385.9466805228026;1480.4152359817872;1698.898066116034;1710.0936503653068;6717.63053032083;7313.634318284091;7349.154847192574;7865.724699635514;7909.0904545977155;7415.962920185391;7644.044494438195;7668.923310766891;7748.806279843006;7750.263724946121;2124.8618839775404;2157.018556556763;2171.2834764527747;2174.1738139506965;2175.9891200543975;2129.4569884679386;2147.5919575280723;2166.642503986848;2184.803367696907;2193.309107631091;2163.642998905179;2174.2172817785586;2176.597329494041;2182.5743979923923;2212.192549719349;2116.375669177596;2117.227212067592;2121.2045482943895;2121.2999710095633;2127.7659457459667;2073.9066741996494;2105.4420578546697;2105.9578808423744;2108.5993661204475;2109.2617583845686;7676.884846727304;7756.922430775733;7767.883481747778;7778.6888524458955;7796.376289896794;4377.715448495837;4443.600075993176;4479;4479.596836284717;4485.416895803557;2655.176895162506;2703.4863375958503;2737.603047558113;2786.442711457696;2787.3589074512774;840.6889450903205;848.6478111583685;871.2202578692035;884.8716936044237;887.352232870002;10135.493225338778;10358.637447689294;10399.636012739518;10403.271770976035;10434.113100386476;4018.83924643011;4070.2876996526084;4220.936685949713;4239.0674051708575;4243.830246790156;8874.86687699685;8875.955620221857;8920.375573709778;8950.552472376356;8969.282457403391;4535.614472769786;4545.36364908913;4549.363089167519;4555.817767289338;4567.451905771329;3566.6433356664124;3991.860284890015;4128.4632997710705;4175;4206.537280899099;3551.9289614207573;3649.817509124533;3688.8708895189075;3739.1773809761808;3761.1349389640536;1155.9768804623861;1190.9404529773476;1195.4799662146993;1204.644629834201;1213.6177104212145;608.4615115622706;752.7967448788796;763.1948294549304;775.441681988967;786.3866184376195;4631.722096674211;4832.323474713543;4834.709917404967;4900.705957642553;4957.082939656175;386.66167103784187;395.6972915719477;396.3836234655139;397.4654090248611;399.7601439136495;3266.2324353776844;3297.4394352960053;3332.750043746729;3373.8144402057633;3392.830358482066;8987.325950553735;9281.907180928105;9388.202002829836;9400.858987115198;9418.058194180665;9001.324900632348;9301.069893010645;9414.717558473258;9420.717378478657;9437.76405589852;6905.482088843357;7009.544379615309;7022.578645281299;7026.051483049723;7038.401735852408;4629.375034370317;4649.8140074398;4751.50109238525;4751.786169622306;4799.064182484382;8561.48631082137;8575.271101956403;8584.570771461276;8604;8746.956265218632;8360.498370097814;8683.435576687496;8835.911640883509;8883.511406872683;8884.111588841064;5665.461781130786;5832.533397328289;6048.395160483917;6455.483561315177;6559.376859198559;7243.637818108968;7262.237465066303;7272.054632897901;7284.49008569395;7336.339729424378;6273.96863015682;6422;6452.774152904626;6474.417302442803;6521.087047813215;6236.812895613139;6282.057691346335;6409.71156297977;6487.22153341602;6487.351264873475;5962.403759624003;5962.910556341745;6014.0377539593455;6039.4262545058145;6040.546958978182;4014.598540145962;4022.537408198095;4091.693123015726;4137.338025915839;4150.8339666413;4062.309407400808;4080.897977550585;4115.7205240174435;4144.5026596808575;4173.749575025387 02:53:30 INFO - PROCESS | 22258 | |4;prototype.html;299.1936730511272;299.20859327079876;302.38615610311075;305.70804881338324;307.24724425158365;5035.582920198307;5037.571806396456;5041.924371134436;5045.34410526631;5052.343195384599;4948.233023881296;4953.108440480712;4960.479149689285;4995.075910956467;5016.974915125419;3709.610490898457;3802.2395520895793;3901.356276214421;3901.531816182062;3915.804209789513;3877.922441551167;3879.941800872989;3894.922101557967;3900.6737709178874;3906.046976511744;3869.5163104611925;3885.261800257956;3898.2398432305713;3910.354791459406;3910.76535407875;3778.149916268845;3887.786171760552;3891.5524714657895;3895.2014836958356;3899.7966149125796;3406.7104296134858;3409.3863104641155;3411.675890790371;3414.8121853298057;3435.4331535296647;4841.95158048422;4856.320115183842;4857.110019538369;4875.8781030474165;4881.536254055859;4365.083332500179;4462.219111655448;4481.753503557303;4488.461384633865;4497.550244975509;5146.716930568818;5170.1986192140275;5170.896582068375;5188.6367954243215;5199.584033277367;3742.401215805485;3751.662350388478;3754.662080412776;3767.5478942526797;3774.9237919144634;5395.433479484676;5444.237806707104;5451.945480545183;5452.809151679712;5470.79642478654;3531.4526248431534;3725.5529336479253;3731.1231860512758;3733.8879833605033;3735.122246272124;3751.549814022335;3782.2624588205585;3792;3795.772253664789;3800.1069748609057;4348.717333373321;4357.455318085239;4358;4361.672874534423;4379.189849877719;5068.847934561969;5189.532942035235;5207.869803254949;5248.6325957182635;5252.894942101213;1286.3632501911613;1296.5397283964246;1302.3293004102895;1302.9022823288292;1304.2761267496442;809.874469457235;811.7296431085333;821.4003777242647;838.9638796086828;849.7960489482604;4479.417675702138;4629.467611224685;4637.6289896808175;4639.443266808004;4664.370310008106;5363.5440987516495;5369.812056578079;5372.409035006146;5418.962872659894;5427.782888684408;4416.006398560298;4626.1441633297945;4670.369500117441;4671.883202919954;4687.367205427292;2822.20978126125;2823.6046953426535;2837.6736675282605;2841.957370639442;2842.261012136818;5037.29477873098;5056.82301119459;5062.051110322479;5063.594912406998;5098.694078355311;5196.53231209193;5417.783288668488;5495;5496.86678593198;5565.499105080562;5095.8980820383385;5096.872578185501;5108.7190204538365;5135.281060651511;5139.357580302462;5402.405735369028;5439.3200849893765;5459.587757651468;5464.617476776588;5494.642848214853;5177.068127737043;5293.206019097012;5296.258523806593;5312.1766126250495;5330.93381323729;5149.639525233198;5164.225366194951;5170.458236108278;5178.022636983825;5184.455632158569;3806.771593704276;3828.5597156326266;3831.731778775459;3836.2519308734527;3837.771912987817;5192.922106168335;5392.137258038695;5410.188471729115;5427.755750991294;5490.258815059916;5264.368275806928;5265.868353291198;5269.394019687785;5282.6038047147385;5337.546308563816;5266.657667251617;5268.552173065333;5273.916802862771;5330.973345133405;5345.919811202757;4977.925331119964;5116.976604679154;5136.743162841918;5168.147255702917;5169.586433085419;5016.623753218596;5165.974170129125;5298.814541491183;5307.497051945697;5327;5155.742212889416;5164.922526162036;5187.18448543022;5187.740612969261;5201.349831271091 02:53:30 INFO - PROCESS | 22258 | |5;yui.html;559.9944000559993;569.4732372555386;576.7001159397113;585.6603170161306;647.6470323673598;11713.238639488427;11963.521459141646;12268.938655306722;12402.255864648127;12407.255564666126;13108.147970381942;13134.277614731185;13223.272720000421;13242.271675057867;13267;623.628940780235;755.5504474837463;764.1899586438379;783.7413653494361;784.0082295895696;783.3145997252404;790;790.8339248757738;792.5878543157554;794.8132188935596;831.2186544648042;832.2260297922929;834.9540775257359;837.1795640272536;838.1283465196188;819.8647223208193;826.3843436639681;826.6114925984807;829.8713699376545;833.2667252817512;604.2446941323345;607.5534482155612;607.6536374266669;607.7933502609134;608.1607381813113;13609.183448993092;13728.176309421468;13730.176189428566;13847.16916984974;13872.861271387359;13203.73592528144;13497.325133743274;13581.320933953362;13696.726065478735;14001.859981400157;10248.897511024868;10458.581656733722;10490.423026733526;10550.683479495627;10615.946920265427;3246.5454836322933;3315.966840331614;3359.4288970874763;3360.294338188983;3375.5443015193127;66669.66665166692;67760;68208.3179168207;69290.3070969289;69539.95690064704;10098;10240.795184096276;10285.691429257135;10334.689959301233;10480.528376223088;17847.643047138983;17894.194761235514;18011.72982405265;18072.638547229246;18562.071896405127;6646.534742567974;6674.599524028574;6720.6639668016405;6793;6877.724891004404;3440.139965008748;3519.348920449725;3541.734369922266;3552.928941421209;3603.7117030637487;2927.429151315516;3046.5887105240954;3055.052933590594;3055.7097075777765;3064.5249986252165;484.77700257881065;488.4553722599276;491.36613768239283;504.6593549354171;505.57784250150803;459.2147427898331;540.9594280428984;551.3769440532172;553.2310088976326;562.2578196780211;7549.50928189666;7681.654325555363;7780.388869763096;7979.441439099323;8527;470.74344482257254;476.22850981410335;532.5766016017276;538.9299391079213;554.1374439295216;3890.8054597270025;4077.796110194538;4102.405151253051;4108.281050816096;4170.874873753793;87420;92122;93776;94608.52695736477;94672;84122;87432.56283718541;87673.56163219143;88065.55967220123;88521.55739221262;76455.61772191104;76767.23232767712;76886.23113768791;77072.61463692758;78911;7272;7275.781726548212;7495.475316727995;7514.248575142442;7578.848423031398;45120.77439612781;46689.53310466852;47049;47536.7623161882;48885.75557122192;59142;64798.352016479235;66991.66504167448;67454.66272668606;67690;9911.207103431563;10130.037646423578;10383.792324153626;10385.273030888067;10393.9480302598;10754.24720269605;10966.890331096587;11199.328040317281;11249.831252531056;11401;10369.170466362824;10633;10662.680119596425;11112.166587505808;11150.944245278723;10095.697129086138;10107.444090575089;10382.844257336297;10564.894351056391;10955.34267943926;10353;10525.473726313501;10592.629257975934;10602.946985265333;10981.505832237408;8475.321974241922;8538.615762290588;8540.27407670355;8953.104689530996;9190.218831399407;8051.194880511902;8682.131786821268;8759.080296568769;8902.376833621584;8982.640694372152 02:53:30 INFO - PROCESS | 22258 | __end_tp_report 02:53:30 INFO - PROCESS | 22258 | __start_cc_report 02:53:30 INFO - PROCESS | 22258 | _x_x_mozilla_cycle_collect,395 02:53:30 INFO - PROCESS | 22258 | __end_cc_report 02:53:30 INFO - PROCESS | 22258 | __startTimestamp1468230810362__endTimestamp 02:53:30 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | ------- Summary: start ------- 02:53:30 INFO - PROCESS | 22258 | Number of tests: 6 02:53:30 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | [#0] dojo.html Cycles:165 Average:4564.36 Median:4716.20 stddev:580.39 (12.3%) stddev-sans-first:560.65 02:53:30 INFO - PROCESS | 22258 | Values: 2568.4 2568.6 2569.2 2606.4 2610.9 4648.9 4671.8 4701.3 4716.2 4756.0 4575.6 4604.7 4612.8 4644.0 4650.2 4228.8 4312.3 4343.1 4364.4 4365.6 259.3 4246.5 4302.6 4320.4 4329.8 4235.8 4260.9 4269.4 4305.6 4321.4 4190.4 4253.3 4270.1 4297.9 4345.0 4191.9 4251.7 4261.6 4272.0 4273.9 4601.2 4619.9 4636.8 4662.2 4697.7 4835.5 4898.9 4944.7 4953.1 4964.6 4943.2 4980.6 4982.6 5000.6 5035.1 4672.0 4683.7 4684.4 4692.2 4724.9 4956.8 5005.5 5043.0 5114.9 5160.2 4865.5 4893.9 4895.6 4925.7 4928.0 4945.1 4946.0 4954.1 4966.6 4971.7 4776.6 4839.9 4870.0 4901.8 4955.2 4757.3 4809.6 4884.2 4886.2 4892.5 4213.1 4221.9 4229.0 4257.9 4260.7 3609.3 3617.0 3639.8 3657.1 3685.5 4332.0 4346.5 4349.0 4350.0 4386.0 4897.0 4947.1 4952.7 4962.9 4987.9 4349.2 4376.2 4385.9 4388.6 4401.6 4467.2 4496.7 4502.0 4549.2 4570.3 4596.0 4597.3 4720.4 4732.4 4732.7 4881.8 4901.1 4902.3 4914.4 4967.4 4584.3 4624.6 4635.3 4641.1 4683.2 4726.3 4832.2 4836.1 4871.7 4922.7 5022.3 5022.9 5024.2 5029.9 5054.3 4864.1 4877.5 4882.7 4898.2 4907.7 4737.9 4744.7 4825.4 4853.7 4921.8 4615.8 4679.5 4749.7 4758.6 4778.3 4892.7 4894.3 4900.5 4901.0 4941.4 4638.8 4726.0 4777.4 4780.0 4788.5 02:53:30 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | [#1] ext.html Cycles:180 Average:47963.86 Median:197069.23 stddev:93626.12 (47.5%) stddev-sans-first:93821.09 02:53:30 INFO - PROCESS | 22258 | Values: 551.5 552.2 558.4 561.8 580.9 34776.3 38393.6 38653.6 38668.0 38741.6 38181.0 38976.0 39026.4 39082.2 39161.8 7481.6 7741.2 7776.9 7778.3 7802.4 7731.3 7802.6 7806.6 7815.0 7829.3 7824.9 7834.2 7853.5 7878.4 7887.4 7812.8 7822.1 7844.8 7856.7 7862.7 7745.9 7799.8 7803.4 7822.6 7862.4 36393.5 36750.8 36780.1 36804.0 36942.1 2836.4 3156.7 3209.6 3325.9 3357.6 27165.2 27477.5 27480.2 27707.7 27930.3 3114.0 3115.2 3137.5 3184.0 3210.4 267601.0 268381.0 269834.0 269953.0 270505.0 31475.7 45504.3 45740.0 45773.5 45903.8 31844.4 33862.3 33924.0 33971.5 34028.0 11961.7 11961.9 12066.7 12084.8 12099.6 11137.2 11201.2 11216.7 11217.5 11249.4 7816.8 7857.3 7881.3 7951.0 7970.9 3141.1 3151.9 3168.3 3176.3 3176.8 864.4 886.6 899.9 987.8 1000.7 27672.7 28005.0 28095.4 28097.6 28725.0 891.0 930.5 935.5 960.6 985.1 12971.0 13192.8 13359.9 13447.3 13470.7 404530.0 410464.0 410521.0 410592.0 410930.0 44745.6 45974.8 46040.5 46137.5 46147.0 1137.3 1198.1 1215.6 1219.3 1226.9 24886.1 25109.4 25350.4 25693.7 26014.3 39788.8 40648.2 40725.4 40742.6 40789.4 357745.0 367242.1 368832.0 370002.0 372367.0 24022.2 24280.2 24316.0 24335.5 24351.4 39105.6 39823.0 40011.8 40392.8 40824.6 34508.0 34543.8 34843.5 34999.5 35364.1 33019.8 33092.7 33330.8 33506.2 33854.2 33917.7 34460.1 36612.5 37104.3 37292.6 31613.8 32957.0 33067.5 33467.5 33573.3 24602.5 25668.5 25870.0 25965.6 25990.5 02:53:30 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | [#2] jquery.html Cycles:180 Average:23605.68 Median:51689.37 stddev:62147.82 (120.2%) stddev-sans-first:62297.65 02:53:30 INFO - PROCESS | 22258 | Values: 357.5 360.3 364.4 379.0 380.6 16099.4 16382.3 17649.0 17666.6 17679.3 16129.6 16324.3 16891.2 16905.7 16973.0 5106.1 5185.5 5268.2 5272.6 5275.2 5119.6 5180.5 5193.9 5198.8 5221.7 5353.3 5406.8 5407.6 5409.2 5414.1 5223.8 5293.4 5350.5 5359.5 5415.5 5190.5 5210.4 5215.7 5269.4 5327.5 12302.8 12313.3 17097.1 20841.4 21493.4 1914.4 1957.6 2010.3 2081.7 2380.8 9047.0 10000.5 12264.5 13176.1 13439.1 1645.7 1729.4 1751.5 1779.6 1823.6 55761.4 62789.7 63507.4 65833.7 69664.7 9257.5 9461.7 9894.6 9930.1 9938.4 13285.8 13332.5 13348.5 13401.7 13497.5 6588.3 6624.2 6789.0 6880.5 7078.9 6449.5 6466.3 6524.6 6552.4 6670.1 4102.8 4153.0 4171.3 4210.7 4239.4 1763.0 1793.2 1793.8 1803.1 1833.3 847.8 880.7 913.2 938.8 972.0 15548.6 16868.3 17519.4 17584.9 17609.1 819.2 822.4 857.8 873.7 918.5 8971.8 9647.6 9655.8 9715.3 9924.7 370130.0 374188.0 379423.0 379464.0 380189.0 70277.0 70982.0 73887.6 78071.2 78988.2 918.9 941.9 953.3 986.1 987.4 15817.8 15995.4 16028.1 16033.4 16486.4 37494.4 37854.2 37906.2 38061.0 38844.0 45509.3 51631.7 51747.0 51758.0 51784.0 7248.7 7295.1 7330.5 7336.2 7460.4 8040.7 10885.8 11615.2 11670.3 12099.3 9063.0 9441.8 9792.2 10086.8 10099.6 9811.2 10205.8 10262.7 10334.5 10363.8 9965.2 10309.5 10584.9 10654.3 10705.5 7215.0 7232.5 7281.2 7310.3 7407.8 9952.9 10352.5 10395.5 10498.4 10631.0 02:53:30 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | [#3] mootools.html Cycles:180 Average:4926.96 Median:4630.55 stddev:2804.62 (60.6%) stddev-sans-first:2799.69 02:53:30 INFO - PROCESS | 22258 | Values: 1361.4 1385.9 1480.4 1698.9 1710.1 6717.6 7313.6 7349.2 7865.7 7909.1 7416.0 7644.0 7668.9 7748.8 7750.3 2124.9 2157.0 2171.3 2174.2 2176.0 2129.5 2147.6 2166.6 2184.8 2193.3 2163.6 2174.2 2176.6 2182.6 2212.2 2116.4 2117.2 2121.2 2121.3 2127.8 2073.9 2105.4 2106.0 2108.6 2109.3 7676.9 7756.9 7767.9 7778.7 7796.4 4377.7 4443.6 4479.0 4479.6 4485.4 2655.2 2703.5 2737.6 2786.4 2787.4 840.7 848.6 871.2 884.9 887.4 10135.5 10358.6 10399.6 10403.3 10434.1 4018.8 4070.3 4220.9 4239.1 4243.8 8874.9 8876.0 8920.4 8950.6 8969.3 4535.6 4545.4 4549.4 4555.8 4567.5 3566.6 3991.9 4128.5 4175.0 4206.5 3551.9 3649.8 3688.9 3739.2 3761.1 1156.0 1190.9 1195.5 1204.6 1213.6 608.5 752.8 763.2 775.4 786.4 4631.7 4832.3 4834.7 4900.7 4957.1 386.7 395.7 396.4 397.5 399.8 3266.2 3297.4 3332.8 3373.8 3392.8 8987.3 9281.9 9388.2 9400.9 9418.1 9001.3 9301.1 9414.7 9420.7 9437.8 6905.5 7009.5 7022.6 7026.1 7038.4 4629.4 4649.8 4751.5 4751.8 4799.1 8561.5 8575.3 8584.6 8604.0 8747.0 8360.5 8683.4 8835.9 8883.5 8884.1 5665.5 5832.5 6048.4 6455.5 6559.4 7243.6 7262.2 7272.1 7284.5 7336.3 6274.0 6422.0 6452.8 6474.4 6521.1 6236.8 6282.1 6409.7 6487.2 6487.4 5962.4 5962.9 6014.0 6039.4 6040.5 4014.6 4022.5 4091.7 4137.3 4150.8 4062.3 4080.9 4115.7 4144.5 4173.7 02:53:30 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | [#4] prototype.html Cycles:180 Average:4343.50 Median:5016.80 stddev:1278.27 (25.5%) stddev-sans-first:1245.29 02:53:30 INFO - PROCESS | 22258 | Values: 299.2 299.2 302.4 305.7 307.2 5035.6 5037.6 5041.9 5045.3 5052.3 4948.2 4953.1 4960.5 4995.1 5017.0 3709.6 3802.2 3901.4 3901.5 3915.8 3877.9 3879.9 3894.9 3900.7 3906.0 3869.5 3885.3 3898.2 3910.4 3910.8 3778.1 3887.8 3891.6 3895.2 3899.8 3406.7 3409.4 3411.7 3414.8 3435.4 4842.0 4856.3 4857.1 4875.9 4881.5 4365.1 4462.2 4481.8 4488.5 4497.6 5146.7 5170.2 5170.9 5188.6 5199.6 3742.4 3751.7 3754.7 3767.5 3774.9 5395.4 5444.2 5451.9 5452.8 5470.8 3531.5 3725.6 3731.1 3733.9 3735.1 3751.5 3782.3 3792.0 3795.8 3800.1 4348.7 4357.5 4358.0 4361.7 4379.2 5068.8 5189.5 5207.9 5248.6 5252.9 1286.4 1296.5 1302.3 1302.9 1304.3 809.9 811.7 821.4 839.0 849.8 4479.4 4629.5 4637.6 4639.4 4664.4 5363.5 5369.8 5372.4 5419.0 5427.8 4416.0 4626.1 4670.4 4671.9 4687.4 2822.2 2823.6 2837.7 2842.0 2842.3 5037.3 5056.8 5062.1 5063.6 5098.7 5196.5 5417.8 5495.0 5496.9 5565.5 5095.9 5096.9 5108.7 5135.3 5139.4 5402.4 5439.3 5459.6 5464.6 5494.6 5177.1 5293.2 5296.3 5312.2 5330.9 5149.6 5164.2 5170.5 5178.0 5184.5 3806.8 3828.6 3831.7 3836.3 3837.8 5192.9 5392.1 5410.2 5427.8 5490.3 5264.4 5265.9 5269.4 5282.6 5337.5 5266.7 5268.6 5273.9 5331.0 5345.9 4977.9 5117.0 5136.7 5168.1 5169.6 5016.6 5166.0 5298.8 5307.5 5327.0 5155.7 5164.9 5187.2 5187.7 5201.3 02:53:30 INFO - PROCESS | 22258 | 02:53:30 INFO - PROCESS | 22258 | [#5] yui.html Cycles:180 Average:17821.16 Median:505.12 stddev:25899.77 (5127.5%) stddev-sans-first:25940.00 02:53:30 INFO - PROCESS | 22258 | Values: 560.0 569.5 576.7 585.7 647.6 11713.2 11963.5 12268.9 12402.3 12407.3 13108.1 13134.3 13223.3 13242.3 13267.0 623.6 755.6 764.2 783.7 784.0 783.3 790.0 790.8 792.6 794.8 831.2 832.2 835.0 837.2 838.1 819.9 826.4 826.6 829.9 833.3 604.2 607.6 607.7 607.8 608.2 13609.2 13728.2 13730.2 13847.2 13872.9 13203.7 13497.3 13581.3 13696.7 14001.9 10248.9 10458.6 10490.4 10550.7 10615.9 3246.5 3316.0 3359.4 3360.3 3375.5 66669.7 67760.0 68208.3 69290.3 69540.0 10098.0 10240.8 10285.7 10334.7 10480.5 17847.6 17894.2 18011.7 18072.6 18562.1 6646.5 6674.6 6720.7 6793.0 6877.7 3440.1 3519.3 3541.7 3552.9 3603.7 2927.4 3046.6 3055.1 3055.7 3064.5 484.8 488.5 491.4 504.7 505.6 459.2 541.0 551.4 553.2 562.3 7549.5 7681.7 7780.4 7979.4 8527.0 470.7 476.2 532.6 538.9 554.1 3890.8 4077.8 4102.4 4108.3 4170.9 87420.0 92122.0 93776.0 94608.5 94672.0 84122.0 87432.6 87673.6 88065.6 88521.6 76455.6 76767.2 76886.2 77072.6 78911.0 7272.0 7275.8 7495.5 7514.2 7578.8 45120.8 46689.5 47049.0 47536.8 48885.8 59142.0 64798.4 66991.7 67454.7 67690.0 9911.2 10130.0 10383.8 10385.3 10393.9 10754.2 10966.9 11199.3 11249.8 11401.0 10369.2 10633.0 10662.7 11112.2 11150.9 10095.7 10107.4 10382.8 10564.9 10955.3 10353.0 10525.5 10592.6 10602.9 10981.5 8475.3 8538.6 8540.3 8953.1 9190.2 8051.2 8682.1 8759.1 8902.4 8982.6 02:53:30 INFO - PROCESS | 22258 | -------- Summary: end -------- 02:53:30 INFO - PROCESS | 22258 | 02:53:31 INFO - TEST-INFO | 22258: exit 0 02:53:31 INFO - TEST-OK | dromaeo_css | took 1116933ms 02:53:31 INFO - TEST-START | kraken 02:53:31 INFO - operating with platform_type : linux_ 02:53:31 INFO - Initialising browser for kraken test... 02:53:31 INFO - TEST-INFO | started process 22501 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWn24hX/profile http://localhost:39423/getInfo.html) 02:53:36 INFO - PROCESS | 22501 | __metrics Screen width/height:1600/1200 02:53:36 INFO - PROCESS | 22501 | colorDepth:24 02:53:36 INFO - PROCESS | 22501 | Browser inner width/height: 1024/697 02:53:36 INFO - PROCESS | 22501 | __metrics 02:53:36 ERROR - PROCESS | 22501 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2964: TypeError: this.tabs is undefined 02:53:37 INFO - TEST-INFO | 22501: exit 0 02:53:37 INFO - Browser initialized. 02:53:37 INFO - Running cycle 1/1 for kraken test... 02:53:37 INFO - TEST-INFO | started process 22621 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWn24hX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:53:49 INFO - PROCESS | 22621 | RSS: Main: 169385984 02:53:49 INFO - PROCESS | 22621 | 02:53:52 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39423/tests/kraken/driver.html?testName=audio-beat-detection) 02:53:53 INFO - PROCESS | 22621 | RSS: Main: 173985792 02:53:53 INFO - PROCESS | 22621 | 02:53:56 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39423/tests/kraken/driver.html?testName=audio-dft) 02:53:56 INFO - PROCESS | 22621 | RSS: Main: 173932544 02:53:56 INFO - PROCESS | 22621 | 02:53:59 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39423/tests/kraken/driver.html?testName=audio-fft) 02:54:00 INFO - PROCESS | 22621 | RSS: Main: 168050688 02:54:00 INFO - PROCESS | 22621 | 02:54:02 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39423/tests/kraken/driver.html?testName=audio-oscillator) 02:54:03 INFO - PROCESS | 22621 | RSS: Main: 168722432 02:54:03 INFO - PROCESS | 22621 | 02:54:05 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39423/tests/kraken/driver.html?testName=imaging-gaussian-blur) 02:54:05 INFO - PROCESS | 22621 | RSS: Main: 169476096 02:54:05 INFO - PROCESS | 22621 | 02:54:09 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39423/tests/kraken/driver.html?testName=imaging-darkroom) 02:54:09 INFO - PROCESS | 22621 | RSS: Main: 169738240 02:54:09 INFO - PROCESS | 22621 | 02:54:13 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39423/tests/kraken/driver.html?testName=imaging-desaturate) 02:54:13 INFO - PROCESS | 22621 | RSS: Main: 167415808 02:54:13 INFO - PROCESS | 22621 | 02:54:16 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39423/tests/kraken/driver.html?testName=json-parse-financial) 02:54:17 INFO - PROCESS | 22621 | RSS: Main: 168902656 02:54:17 INFO - PROCESS | 22621 | 02:54:19 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39423/tests/kraken/driver.html?testName=json-stringify-tinderbox) 02:54:19 INFO - PROCESS | 22621 | RSS: Main: 169795584 02:54:19 INFO - PROCESS | 22621 | 02:54:21 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39423/tests/kraken/driver.html?testName=stanford-crypto-aes) 02:54:22 INFO - PROCESS | 22621 | RSS: Main: 169447424 02:54:22 INFO - PROCESS | 22621 | 02:54:24 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39423/tests/kraken/driver.html?testName=stanford-crypto-ccm) 02:54:25 INFO - PROCESS | 22621 | RSS: Main: 169463808 02:54:25 INFO - PROCESS | 22621 | 02:54:28 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39423/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 02:54:28 INFO - PROCESS | 22621 | RSS: Main: 169857024 02:54:28 INFO - PROCESS | 22621 | 02:54:31 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39423/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 02:54:32 INFO - PROCESS | 22621 | RSS: Main: 170033152 02:54:32 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | Cycle 1(1): loaded http://localhost:39423/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39423/tests/kraken/driver.html?testName=ai-astar) 02:54:34 INFO - PROCESS | 22621 | RSS: Main: 171102208 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | __start_tp_report 02:54:34 INFO - PROCESS | 22621 | _x_x_mozilla_page_load 02:54:34 INFO - PROCESS | 22621 | _x_x_mozilla_page_load_details 02:54:34 INFO - PROCESS | 22621 | |i|pagename|runs| 02:54:34 INFO - PROCESS | 22621 | |0;ai-astar;107;116;109;117;115;117;117;116;115;115 02:54:34 INFO - PROCESS | 22621 | |1;audio-beat-detection;153;124;147;179;126;155;149;125;185;133 02:54:34 INFO - PROCESS | 22621 | |2;audio-dft;163;163;162;167;170;163;164;163;162;161 02:54:34 INFO - PROCESS | 22621 | |3;audio-fft;76;78;75;161;77;76;75;76;164;76 02:54:34 INFO - PROCESS | 22621 | |4;audio-oscillator;85;85;153;88;85;86;144;85;85;137 02:54:34 INFO - PROCESS | 22621 | |5;imaging-gaussian-blur;118;118;119;118;118;117;118;119;118;117 02:54:34 INFO - PROCESS | 22621 | |6;imaging-darkroom;148;147;149;148;148;147;147;148;148;147 02:54:34 INFO - PROCESS | 22621 | |7;imaging-desaturate;95;95;95;95;95;96;95;95;95;95 02:54:34 INFO - PROCESS | 22621 | |8;json-parse-financial;63;63;64;64;63;63;63;64;70;63 02:54:34 INFO - PROCESS | 22621 | |9;json-stringify-tinderbox;65;65;65;65;65;65;67;65;65;64 02:54:34 INFO - PROCESS | 22621 | |10;stanford-crypto-aes;81;82;78;79;80;79;80;78;84;80 02:54:34 INFO - PROCESS | 22621 | |11;stanford-crypto-ccm;149;133;141;150;134;134;131;154;174;135 02:54:34 INFO - PROCESS | 22621 | |12;stanford-crypto-pbkdf2;167;171;173;168;170;173;171;168;170;172 02:54:34 INFO - PROCESS | 22621 | |13;stanford-crypto-sha256-iterative;68;69;69;80;70;77;69;68;68;79 02:54:34 INFO - PROCESS | 22621 | __end_tp_report 02:54:34 INFO - PROCESS | 22621 | __start_cc_report 02:54:34 INFO - PROCESS | 22621 | _x_x_mozilla_cycle_collect,981 02:54:34 INFO - PROCESS | 22621 | __end_cc_report 02:54:34 INFO - PROCESS | 22621 | __startTimestamp1468230874275__endTimestamp 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | ------- Summary: start ------- 02:54:34 INFO - PROCESS | 22621 | Number of tests: 14 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#0] ai-astar Cycles:10 Average:114.40 Median:116.00 stddev:3.50 (3.0%) stddev-sans-first:2.49 02:54:34 INFO - PROCESS | 22621 | Values: 107.0 116.0 109.0 117.0 115.0 117.0 117.0 116.0 115.0 115.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#1] audio-beat-detection Cycles:10 Average:147.60 Median:151.00 stddev:21.65 (14.3%) stddev-sans-first:22.87 02:54:34 INFO - PROCESS | 22621 | Values: 153.0 124.0 147.0 179.0 126.0 155.0 149.0 125.0 185.0 133.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#2] audio-dft Cycles:10 Average:163.80 Median:163.00 stddev:2.70 (1.7%) stddev-sans-first:2.85 02:54:34 INFO - PROCESS | 22621 | Values: 163.0 163.0 162.0 167.0 170.0 163.0 164.0 163.0 162.0 161.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#3] audio-fft Cycles:10 Average:93.40 Median:76.00 stddev:36.44 (47.9%) stddev-sans-first:38.10 02:54:34 INFO - PROCESS | 22621 | Values: 76.0 78.0 75.0 161.0 77.0 76.0 75.0 76.0 164.0 76.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#4] audio-oscillator Cycles:10 Average:103.30 Median:85.00 stddev:28.81 (33.9%) stddev-sans-first:29.79 02:54:34 INFO - PROCESS | 22621 | Values: 85.0 85.0 153.0 88.0 85.0 86.0 144.0 85.0 85.0 137.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#5] imaging-gaussian-blur Cycles:10 Average:118.00 Median:118.00 stddev:0.67 (0.6%) stddev-sans-first:0.71 02:54:34 INFO - PROCESS | 22621 | Values: 118.0 118.0 119.0 118.0 118.0 117.0 118.0 119.0 118.0 117.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#6] imaging-darkroom Cycles:10 Average:147.70 Median:148.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 02:54:34 INFO - PROCESS | 22621 | Values: 148.0 147.0 149.0 148.0 148.0 147.0 147.0 148.0 148.0 147.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 02:54:34 INFO - PROCESS | 22621 | Values: 95.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 95.0 95.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#8] json-parse-financial Cycles:10 Average:64.00 Median:63.50 stddev:2.16 (3.4%) stddev-sans-first:2.26 02:54:34 INFO - PROCESS | 22621 | Values: 63.0 63.0 64.0 64.0 63.0 63.0 63.0 64.0 70.0 63.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#9] json-stringify-tinderbox Cycles:10 Average:65.10 Median:65.00 stddev:0.74 (1.1%) stddev-sans-first:0.78 02:54:34 INFO - PROCESS | 22621 | Values: 65.0 65.0 65.0 65.0 65.0 65.0 67.0 65.0 65.0 64.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#10] stanford-crypto-aes Cycles:10 Average:80.10 Median:80.00 stddev:1.85 (2.3%) stddev-sans-first:1.94 02:54:34 INFO - PROCESS | 22621 | Values: 81.0 82.0 78.0 79.0 80.0 79.0 80.0 78.0 84.0 80.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#11] stanford-crypto-ccm Cycles:10 Average:143.50 Median:145.00 stddev:13.49 (9.3%) stddev-sans-first:14.16 02:54:34 INFO - PROCESS | 22621 | Values: 149.0 133.0 141.0 150.0 134.0 134.0 131.0 154.0 174.0 135.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:170.30 Median:171.00 stddev:2.11 (1.2%) stddev-sans-first:1.87 02:54:34 INFO - PROCESS | 22621 | Values: 167.0 171.0 173.0 168.0 170.0 173.0 171.0 168.0 170.0 172.0 02:54:34 INFO - PROCESS | 22621 | 02:54:34 INFO - PROCESS | 22621 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.70 Median:69.50 stddev:4.90 (7.1%) stddev-sans-first:5.01 02:54:34 INFO - PROCESS | 22621 | Values: 68.0 69.0 69.0 80.0 70.0 77.0 69.0 68.0 68.0 79.0 02:54:34 INFO - PROCESS | 22621 | -------- Summary: end -------- 02:54:34 INFO - PROCESS | 22621 | 02:54:35 INFO - TEST-INFO | 22621: exit 0 02:54:35 INFO - TEST-OK | kraken | took 64210ms 02:54:35 INFO - SUITE-END | took 1181s 02:54:35 INFO - Completed test suite (00:19:41) 02:54:35 INFO - javascript benchmark 02:54:35 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6219.495154606286, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2568.3707491664545, 2568.5761849294868, 2569.2292312306304, 2606.4135569496875, 2610.895564177433, 4648.907021859561, 4671.766411679415, 4701.294805779135, 4716.198246298129, 4756.048790241953, 4575.633949284058, 4604.654650901179, 4612.8385506507275, 4643.976780116103, 4650.209464391053, 4228.809703563347, 4312.28847240205, 4343.131373725252, 4364.388985542027, 4365.585269399402, 259.2516324238469, 4246.490421149467, 4302.591253830897, 4320.351947207928, 4329.7618630975285, 4235.788210589458, 4260.893477663052, 4269.423627810268, 4305.590968857953, 4321.395004699345, 4190.413342132104, 4253.319468884994, 4270.0605866709275, 4297.871063868089, 4345.022369966764, 4191.874243772691, 4251.659867210616, 4261.552536983634, 4271.9572804271875, 4273.893152671208, 4601.240795268776, 4619.907601847978, 4636.768161591907, 4662.230731929228, 4697.7181369117625, 4835.468098509161, 4898.90202195954, 4944.653874228806, 4953.0836795192645, 4964.60283177345, 4943.159662857287, 4980.576650984671, 4982.626303027288, 5000.599952003868, 5035.093683137034, 4671.953280467186, 4683.6721429500285, 4684.367610372624, 4692.1554120258, 4724.858254252413, 4956.776945037482, 5005.499450055038, 5042.9747851261245, 5114.872128196825, 5160.225966105039, 4865.489123642037, 4893.877653058702, 4895.583875370633, 4925.704457732548, 4928.0, 4945.085159245551, 4946.0, 4954.058728841508, 4966.553010229097, 4971.651984361132, 4776.593989510861, 4839.854804355875, 4869.975650121727, 4901.779419926112, 4955.157623204064, 4757.286407038971, 4809.591184749265, 4884.169691152512, 4886.193778026657, 4892.510748925079, 4213.073123912734, 4221.894452638647, 4228.9788551057045, 4257.87226383209, 4260.659147268211, 3609.296187243462, 3617.0, 3639.836207370675, 3657.1040095176318, 3685.502457168248, 4332.0469496710675, 4346.543612920661, 4348.978255108767, 4349.978250108729, 4386.0, 4897.0, 4947.134251506044, 4952.653314267966, 4962.925556116661, 4987.875303117378, 4349.217140914602, 4376.234159022159, 4385.890352741207, 4388.626966707801, 4401.6478681705385, 4467.15124126415, 4496.685232033727, 4502.0, 4549.226631472658, 4570.314452832102, 4596.0, 4597.287420449702, 4720.433547974197, 4732.361131247238, 4732.716037037789, 4881.829135980223, 4901.068796928572, 4902.338184345211, 4914.434839993446, 4967.354243948408, 4584.266517357207, 4624.560666736655, 4635.281531362644, 4641.071785642817, 4683.227267500961, 4726.338312636302, 4832.1543729846435, 4836.081144582518, 4871.683340582851, 4922.729249891147, 5022.271770593316, 5022.949770502249, 5024.196128619549, 5029.949700502948, 5054.342935418372, 4864.148773964472, 4877.487863774252, 4882.707037577757, 4898.191798353232, 4907.68100073494, 4737.9052418952115, 4744.667873248839, 4825.445073816556, 4853.708777473222, 4921.778519966681, 4615.838445654386, 4679.532046795293, 4749.738764367855, 4758.571728544448, 4778.259369797687, 4892.65751397413, 4894.2658601210105, 4900.4854490278, 4901.044296362175, 4941.43173535048, 4638.837640682695, 4726.031163611383, 4777.4267087949665, 4780.020095880405, 4788.473267940593], "value": 4530.095311610009, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [551.4568150371883, 552.1607157121175, 558.4499268220802, 561.7809054468755, 580.9244798176236, 34776.30447391054, 38393.616063839356, 38653.61346386535, 38668.0, 38741.61258387419, 38181.0, 38976.0, 39026.4146037809, 39082.21835563287, 39161.804190979004, 7481.6259187040705, 7741.22587741227, 7776.883346749803, 7778.299953004229, 7802.375809935192, 7731.342835858959, 7802.64888080035, 7806.60966951653, 7815.0, 7829.295363417291, 7824.882626760603, 7834.216578342149, 7853.528788272693, 7878.409119316074, 7887.408444366667, 7812.843743125162, 7822.139564647884, 7844.803879902991, 7856.725014624518, 7862.724804631867, 7745.883811742829, 7799.805004874924, 7803.414743894231, 7822.6088695564995, 7862.449628526006, 36393.45409818855, 36750.81624591887, 36780.080497987496, 36804.0, 36942.076448088745, 2836.404355085414, 3156.684331566848, 3209.5988001499813, 3325.8503367348526, 3357.6474470180524, 27165.1850444487, 27477.45045099107, 27480.17559473219, 27707.722922770718, 27930.3017424564, 3113.9532907006187, 3115.18740808458, 3137.51368537877, 3183.9840800795846, 3210.357928414303, 267601.0, 268381.0, 269834.0, 269953.0, 270505.0, 31475.685243147276, 45504.317435238496, 45740.0, 45773.54226457759, 45903.77048114738, 31844.36311273808, 33862.32275354528, 33924.0, 33971.49042764361, 34028.0, 11961.700957476132, 11961.880381196077, 12066.69833254158, 12084.818727719092, 12099.637010889688, 11137.164712646583, 11201.21591488588, 11216.66350009501, 11217.495212715285, 11249.437528123724, 7816.804579885435, 7857.253560911704, 7881.290683838367, 7951.0, 7970.920290797134, 3141.0733833519166, 3151.936961260808, 3168.3188114555483, 3176.3170918252226, 3176.7617428692943, 864.3776480933718, 886.6187539358009, 899.8875140607424, 987.8468837330225, 1000.7047920863363, 27672.723272767416, 28005.0, 28095.43809123847, 28097.578536321973, 28724.994625188017, 890.9866352004725, 930.5021813329971, 935.4761333653177, 960.6061514778908, 985.1330828870548, 12971.0, 13192.802107968197, 13359.866401335863, 13447.32763361828, 13470.663233419047, 404530.0, 410464.0, 410521.0, 410592.0, 410930.0, 44745.55254447479, 45974.77012614982, 46040.53959460429, 46137.538624614, 46147.0, 1137.2607804926863, 1198.0655089030397, 1215.5867005218267, 1219.3049961522024, 1226.9325187114973, 24886.128985485422, 25109.372265693502, 25350.366240844127, 25693.743062569883, 26014.34964125912, 39788.80105599453, 40648.187036259704, 40725.389119162646, 40742.59257407388, 40789.38815917823, 357745.0, 367242.14652487036, 368832.0, 370002.0, 372367.0, 24022.15922442706, 24280.150194743805, 24316.0, 24335.513289733753, 24351.391215219763, 39105.608943911335, 39823.0, 40011.79994100011, 40392.79803600963, 40824.59175408208, 34508.0, 34543.827280863436, 34843.477347839296, 34999.475007875415, 35364.115897102776, 33019.83490082534, 33092.669073308956, 33330.83334583312, 33506.162345940575, 33854.153646158054, 33917.66082339145, 34460.13849653779, 36612.450813238356, 37104.257914841015, 37292.627073728916, 31613.8419307902, 32957.0, 33067.50398744069, 33467.497987530696, 33573.32853342968, 24602.50794984126, 25668.486630267664, 25870.0, 25965.6105158419, 25990.48019039571], "value": 16133.551484742542, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [357.4959307376599, 360.2650592790707, 364.4496809817176, 379.0334646651039, 380.5604526771578, 16099.35602575897, 16382.344706211752, 17649.0, 17666.646667066652, 17679.29282828687, 16129.596760081004, 16324.347026118941, 16891.23989420476, 16905.661886762256, 16973.0, 5106.106431374504, 5185.481451854822, 5268.157094864822, 5272.604554658396, 5275.235090911835, 5119.641625086246, 5180.507851754096, 5193.870153246161, 5198.792048318062, 5221.71280579568, 5353.330833645794, 5406.810761623344, 5407.567394608422, 5409.24270602116, 5414.052540805363, 5223.791048358061, 5293.364796224459, 5350.5452036576935, 5359.5444387227135, 5415.512603865671, 5190.532852043297, 5210.426853046162, 5215.6609820361555, 5269.394019687708, 5327.493888080626, 12302.81545776814, 12313.322767247797, 17097.059661718602, 20841.37475875711, 21493.355199344045, 1914.3586898389055, 1957.5595491014408, 2010.3466373428548, 2081.6669332906663, 2380.845290034349, 9047.0, 10000.549975251131, 12264.509419623204, 13176.077674562785, 13439.059265851394, 1645.7449095390234, 1729.4292883348464, 1751.5270876863303, 1779.5729025034027, 1823.632275793155, 55761.44238557603, 62789.68605156945, 63507.36492635061, 65833.67083164601, 69664.65167674179, 9257.537123143817, 9461.668841590512, 9894.604215831287, 9930.05664461875, 9938.354006989523, 13285.800712989312, 13332.466701332032, 13348.46606135763, 13401.731965360834, 13497.527586534621, 6588.275289718127, 6624.171978502687, 6788.9660551696925, 6880.483963702743, 7078.893816592756, 6449.451796597248, 6466.288708242089, 6524.575902566318, 6552.443042341454, 6670.132882725312, 4102.753834769924, 4152.979235103805, 4171.290880550314, 4210.715731701799, 4239.427677263591, 1763.0, 1793.2289115680383, 1793.7757780277466, 1803.1164729282818, 1833.3399976008627, 847.8130617136059, 880.7049638371218, 913.2055112052424, 938.7934654376027, 971.9562619682131, 15548.611284717972, 16868.32526698943, 17519.386821461187, 17584.912075439795, 17609.119544023004, 819.2135549872189, 822.4414734079006, 857.8198578298502, 873.7335112790532, 918.5361392496746, 8971.775705607412, 9647.614095436104, 9655.806883862284, 9715.319927605, 9924.652637157666, 370130.0, 374188.0, 379423.0, 379464.0, 380189.0, 70277.0, 70982.0, 73887.63056184792, 78071.2192878064, 78988.21011789923, 918.9172974432333, 941.9152276295166, 953.2850362228329, 986.0730912941812, 987.4223579206244, 15817.841821582097, 15995.360185592446, 16028.11845348517, 16033.438829640907, 16486.422975195812, 37494.43758343682, 37854.24291514099, 37906.241875162894, 38061.0, 38844.0, 45509.31736023896, 51631.74184129055, 51747.0, 51758.0, 51784.0, 7248.710051597877, 7295.124585049828, 7330.450216233698, 7336.156342020736, 7460.3658689012045, 8040.718574849852, 10885.836712449478, 11615.245009074382, 11670.299782012768, 12099.33453660022, 9062.954685226532, 9441.763955901157, 9792.216622670026, 10086.8486972694, 10099.596016159272, 9811.215102791903, 10205.795884082425, 10262.692119236435, 10334.5349459273, 10363.84454233172, 9965.202783777135, 10309.536070876678, 10584.89415105839, 10654.254202205771, 10705.518251678537, 7215.025971493781, 7232.493725439379, 7281.235470275757, 7310.305520975498, 7407.8148046299275, 9952.850707239253, 10352.53413596405, 10395.532201050819, 10498.370097794157, 10631.0], "value": 8116.166115466883, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1361.441808858368, 1385.9466805228026, 1480.4152359817872, 1698.898066116034, 1710.0936503653068, 6717.63053032083, 7313.634318284091, 7349.154847192574, 7865.724699635514, 7909.0904545977155, 7415.962920185391, 7644.044494438195, 7668.923310766891, 7748.806279843006, 7750.263724946121, 2124.8618839775404, 2157.018556556763, 2171.2834764527747, 2174.1738139506965, 2175.9891200543975, 2129.4569884679386, 2147.5919575280723, 2166.642503986848, 2184.803367696907, 2193.309107631091, 2163.642998905179, 2174.2172817785586, 2176.597329494041, 2182.5743979923923, 2212.192549719349, 2116.375669177596, 2117.227212067592, 2121.2045482943895, 2121.2999710095633, 2127.7659457459667, 2073.9066741996494, 2105.4420578546697, 2105.9578808423744, 2108.5993661204475, 2109.2617583845686, 7676.884846727304, 7756.922430775733, 7767.883481747778, 7778.6888524458955, 7796.376289896794, 4377.715448495837, 4443.600075993176, 4479.0, 4479.596836284717, 4485.416895803557, 2655.176895162506, 2703.4863375958503, 2737.603047558113, 2786.442711457696, 2787.3589074512774, 840.6889450903205, 848.6478111583685, 871.2202578692035, 884.8716936044237, 887.352232870002, 10135.493225338778, 10358.637447689294, 10399.636012739518, 10403.271770976035, 10434.113100386476, 4018.83924643011, 4070.2876996526084, 4220.936685949713, 4239.0674051708575, 4243.830246790156, 8874.86687699685, 8875.955620221857, 8920.375573709778, 8950.552472376356, 8969.282457403391, 4535.614472769786, 4545.36364908913, 4549.363089167519, 4555.817767289338, 4567.451905771329, 3566.6433356664124, 3991.860284890015, 4128.4632997710705, 4175.0, 4206.537280899099, 3551.9289614207573, 3649.817509124533, 3688.8708895189075, 3739.1773809761808, 3761.1349389640536, 1155.9768804623861, 1190.9404529773476, 1195.4799662146993, 1204.644629834201, 1213.6177104212145, 608.4615115622706, 752.7967448788796, 763.1948294549304, 775.441681988967, 786.3866184376195, 4631.722096674211, 4832.323474713543, 4834.709917404967, 4900.705957642553, 4957.082939656175, 386.66167103784187, 395.6972915719477, 396.3836234655139, 397.4654090248611, 399.7601439136495, 3266.2324353776844, 3297.4394352960053, 3332.750043746729, 3373.8144402057633, 3392.830358482066, 8987.325950553735, 9281.907180928105, 9388.202002829836, 9400.858987115198, 9418.058194180665, 9001.324900632348, 9301.069893010645, 9414.717558473258, 9420.717378478657, 9437.76405589852, 6905.482088843357, 7009.544379615309, 7022.578645281299, 7026.051483049723, 7038.401735852408, 4629.375034370317, 4649.8140074398, 4751.50109238525, 4751.786169622306, 4799.064182484382, 8561.48631082137, 8575.271101956403, 8584.570771461276, 8604.0, 8746.956265218632, 8360.498370097814, 8683.435576687496, 8835.911640883509, 8883.511406872683, 8884.111588841064, 5665.461781130786, 5832.533397328289, 6048.395160483917, 6455.483561315177, 6559.376859198559, 7243.637818108968, 7262.237465066303, 7272.054632897901, 7284.49008569395, 7336.339729424378, 6273.96863015682, 6422.0, 6452.774152904626, 6474.417302442803, 6521.087047813215, 6236.812895613139, 6282.057691346335, 6409.71156297977, 6487.22153341602, 6487.351264873475, 5962.403759624003, 5962.910556341745, 6014.0377539593455, 6039.4262545058145, 6040.546958978182, 4014.598540145962, 4022.537408198095, 4091.693123015726, 4137.338025915839, 4150.8339666413, 4062.309407400808, 4080.897977550585, 4115.7205240174435, 4144.5026596808575, 4173.749575025387], "value": 3897.223040332069, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [299.1936730511272, 299.20859327079876, 302.38615610311075, 305.70804881338324, 307.24724425158365, 5035.582920198307, 5037.571806396456, 5041.924371134436, 5045.34410526631, 5052.343195384599, 4948.233023881296, 4953.108440480712, 4960.479149689285, 4995.075910956467, 5016.974915125419, 3709.610490898457, 3802.2395520895793, 3901.356276214421, 3901.531816182062, 3915.804209789513, 3877.922441551167, 3879.941800872989, 3894.922101557967, 3900.6737709178874, 3906.046976511744, 3869.5163104611925, 3885.261800257956, 3898.2398432305713, 3910.354791459406, 3910.76535407875, 3778.149916268845, 3887.786171760552, 3891.5524714657895, 3895.2014836958356, 3899.7966149125796, 3406.7104296134858, 3409.3863104641155, 3411.675890790371, 3414.8121853298057, 3435.4331535296647, 4841.95158048422, 4856.320115183842, 4857.110019538369, 4875.8781030474165, 4881.536254055859, 4365.083332500179, 4462.219111655448, 4481.753503557303, 4488.461384633865, 4497.550244975509, 5146.716930568818, 5170.1986192140275, 5170.896582068375, 5188.6367954243215, 5199.584033277367, 3742.401215805485, 3751.662350388478, 3754.662080412776, 3767.5478942526797, 3774.9237919144634, 5395.433479484676, 5444.237806707104, 5451.945480545183, 5452.809151679712, 5470.79642478654, 3531.4526248431534, 3725.5529336479253, 3731.1231860512758, 3733.8879833605033, 3735.122246272124, 3751.549814022335, 3782.2624588205585, 3792.0, 3795.772253664789, 3800.1069748609057, 4348.717333373321, 4357.455318085239, 4358.0, 4361.672874534423, 4379.189849877719, 5068.847934561969, 5189.532942035235, 5207.869803254949, 5248.6325957182635, 5252.894942101213, 1286.3632501911613, 1296.5397283964246, 1302.3293004102895, 1302.9022823288292, 1304.2761267496442, 809.874469457235, 811.7296431085333, 821.4003777242647, 838.9638796086828, 849.7960489482604, 4479.417675702138, 4629.467611224685, 4637.6289896808175, 4639.443266808004, 4664.370310008106, 5363.5440987516495, 5369.812056578079, 5372.409035006146, 5418.962872659894, 5427.782888684408, 4416.006398560298, 4626.1441633297945, 4670.369500117441, 4671.883202919954, 4687.367205427292, 2822.20978126125, 2823.6046953426535, 2837.6736675282605, 2841.957370639442, 2842.261012136818, 5037.29477873098, 5056.82301119459, 5062.051110322479, 5063.594912406998, 5098.694078355311, 5196.53231209193, 5417.783288668488, 5495.0, 5496.86678593198, 5565.499105080562, 5095.8980820383385, 5096.872578185501, 5108.7190204538365, 5135.281060651511, 5139.357580302462, 5402.405735369028, 5439.3200849893765, 5459.587757651468, 5464.617476776588, 5494.642848214853, 5177.068127737043, 5293.206019097012, 5296.258523806593, 5312.1766126250495, 5330.93381323729, 5149.639525233198, 5164.225366194951, 5170.458236108278, 5178.022636983825, 5184.455632158569, 3806.771593704276, 3828.5597156326266, 3831.731778775459, 3836.2519308734527, 3837.771912987817, 5192.922106168335, 5392.137258038695, 5410.188471729115, 5427.755750991294, 5490.258815059916, 5264.368275806928, 5265.868353291198, 5269.394019687785, 5282.6038047147385, 5337.546308563816, 5266.657667251617, 5268.552173065333, 5273.916802862771, 5330.973345133405, 5345.919811202757, 4977.925331119964, 5116.976604679154, 5136.743162841918, 5168.147255702917, 5169.586433085419, 5016.623753218596, 5165.974170129125, 5298.814541491183, 5307.497051945697, 5327.0, 5155.742212889416, 5164.922526162036, 5187.18448543022, 5187.740612969261, 5201.349831271091], "value": 3929.3615490773673, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [559.9944000559993, 569.4732372555386, 576.7001159397113, 585.6603170161306, 647.6470323673598, 11713.238639488427, 11963.521459141646, 12268.938655306722, 12402.255864648127, 12407.255564666126, 13108.147970381942, 13134.277614731185, 13223.272720000421, 13242.271675057867, 13267.0, 623.628940780235, 755.5504474837463, 764.1899586438379, 783.7413653494361, 784.0082295895696, 783.3145997252404, 790.0, 790.8339248757738, 792.5878543157554, 794.8132188935596, 831.2186544648042, 832.2260297922929, 834.9540775257359, 837.1795640272536, 838.1283465196188, 819.8647223208193, 826.3843436639681, 826.6114925984807, 829.8713699376545, 833.2667252817512, 604.2446941323345, 607.5534482155612, 607.6536374266669, 607.7933502609134, 608.1607381813113, 13609.183448993092, 13728.176309421468, 13730.176189428566, 13847.16916984974, 13872.861271387359, 13203.73592528144, 13497.325133743274, 13581.320933953362, 13696.726065478735, 14001.859981400157, 10248.897511024868, 10458.581656733722, 10490.423026733526, 10550.683479495627, 10615.946920265427, 3246.5454836322933, 3315.966840331614, 3359.4288970874763, 3360.294338188983, 3375.5443015193127, 66669.66665166692, 67760.0, 68208.3179168207, 69290.3070969289, 69539.95690064704, 10098.0, 10240.795184096276, 10285.691429257135, 10334.689959301233, 10480.528376223088, 17847.643047138983, 17894.194761235514, 18011.72982405265, 18072.638547229246, 18562.071896405127, 6646.534742567974, 6674.599524028574, 6720.6639668016405, 6793.0, 6877.724891004404, 3440.139965008748, 3519.348920449725, 3541.734369922266, 3552.928941421209, 3603.7117030637487, 2927.429151315516, 3046.5887105240954, 3055.052933590594, 3055.7097075777765, 3064.5249986252165, 484.77700257881065, 488.4553722599276, 491.36613768239283, 504.6593549354171, 505.57784250150803, 459.2147427898331, 540.9594280428984, 551.3769440532172, 553.2310088976326, 562.2578196780211, 7549.50928189666, 7681.654325555363, 7780.388869763096, 7979.441439099323, 8527.0, 470.74344482257254, 476.22850981410335, 532.5766016017276, 538.9299391079213, 554.1374439295216, 3890.8054597270025, 4077.796110194538, 4102.405151253051, 4108.281050816096, 4170.874873753793, 87420.0, 92122.0, 93776.0, 94608.52695736477, 94672.0, 84122.0, 87432.56283718541, 87673.56163219143, 88065.55967220123, 88521.55739221262, 76455.61772191104, 76767.23232767712, 76886.23113768791, 77072.61463692758, 78911.0, 7272.0, 7275.781726548212, 7495.475316727995, 7514.248575142442, 7578.848423031398, 45120.77439612781, 46689.53310466852, 47049.0, 47536.7623161882, 48885.75557122192, 59142.0, 64798.352016479235, 66991.66504167448, 67454.66272668606, 67690.0, 9911.207103431563, 10130.037646423578, 10383.792324153626, 10385.273030888067, 10393.9480302598, 10754.24720269605, 10966.890331096587, 11199.328040317281, 11249.831252531056, 11401.0, 10369.170466362824, 10633.0, 10662.680119596425, 11112.166587505808, 11150.944245278723, 10095.697129086138, 10107.444090575089, 10382.844257336297, 10564.894351056391, 10955.34267943926, 10353.0, 10525.473726313501, 10592.629257975934, 10602.946985265333, 10981.505832237408, 8475.321974241922, 8538.615762290588, 8540.27407670355, 8953.104689530996, 9190.218831399407, 8051.194880511902, 8682.131786821268, 8759.080296568769, 8902.376833621584, 8982.640694372152], "value": 6371.150457368355, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1578.0, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 116.0, 109.0, 117.0, 115.0, 117.0, 117.0, 116.0, 115.0, 115.0], "value": 114.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 124.0, 147.0, 179.0, 126.0, 155.0, 149.0, 125.0, 185.0, 133.0], "value": 147.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 162.0, 167.0, 170.0, 163.0, 164.0, 163.0, 162.0, 161.0], "value": 163.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 78.0, 75.0, 161.0, 77.0, 76.0, 75.0, 76.0, 164.0, 76.0], "value": 93.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 153.0, 88.0, 85.0, 86.0, 144.0, 85.0, 85.0, 137.0], "value": 103.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 119.0, 118.0, 118.0, 117.0, 118.0, 119.0, 118.0, 117.0], "value": 118.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 149.0, 148.0, 148.0, 147.0, 147.0, 148.0, 148.0, 147.0], "value": 147.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0], "value": 95.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 64.0, 64.0, 63.0, 63.0, 63.0, 64.0, 70.0, 63.0], "value": 64.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 65.0, 65.0, 65.0, 65.0, 67.0, 65.0, 65.0, 64.0], "value": 65.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 82.0, 78.0, 79.0, 80.0, 79.0, 80.0, 78.0, 84.0, 80.0], "value": 80.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 133.0, 141.0, 150.0, 134.0, 134.0, 131.0, 154.0, 174.0, 135.0], "value": 143.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 171.0, 173.0, 168.0, 170.0, 173.0, 171.0, 168.0, 170.0, 172.0], "value": 170.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 69.0, 69.0, 80.0, 70.0, 77.0, 69.0, 68.0, 68.0, 79.0], "value": 71.7, "unit": "score"}]}]} 02:54:35 INFO - Return code: 0 02:54:35 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 02:54:35 ERROR - # TBPL SUCCESS # 02:54:35 INFO - Running post-action listener: _resource_record_post_action 02:54:35 INFO - ##### 02:54:35 INFO - ##### Finished run-tests step (success) 02:54:35 INFO - ##### 02:54:35 INFO - Running post-run listener: _resource_record_post_run 02:54:35 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 4096; Write bytes: 551636992; Read time: 8; Write time: 588456 02:54:35 INFO - TinderboxPrint: CPU usage
13.3% 02:54:35 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 02:54:35 INFO - TinderboxPrint: I/O write bytes / time
551,636,992 / 588,456 02:54:35 INFO - TinderboxPrint: CPU idle
8,287.0 (86.7%) 02:54:35 INFO - TinderboxPrint: CPU user
1,217.4 (12.7%) 02:54:35 INFO - TinderboxPrint: Swap in / out
0 / 0 02:54:35 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 249757696; Read time: 0; Write time: 363300 02:54:35 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 0; Write bytes: 301588480; Read time: 0; Write time: 225128 02:54:36 INFO - Running post-run listener: _upload_blobber_files 02:54:36 INFO - Blob upload gear active. 02:54:36 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 02:54:36 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 02:54:36 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-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 02:54:36 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-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 02:54:36 INFO - (blobuploader) - INFO - Open directory for files ... 02:54:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 02:54:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:54:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:54:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 02:54:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:54:37 INFO - (blobuploader) - INFO - Done attempting. 02:54:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 02:54:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:54:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:54:41 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 02:54:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:54:41 INFO - (blobuploader) - INFO - Done attempting. 02:54:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 02:54:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:54:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:54:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 02:54:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:54:41 INFO - (blobuploader) - INFO - Done attempting. 02:54:41 INFO - (blobuploader) - INFO - Iteration through files over. 02:54:41 INFO - Return code: 0 02:54:41 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 02:54:41 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 02:54:41 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/45d4f73447dddf249786c757b72f2db177621dfc48c81257818ac06276e1e099519bf9eca310cc5f7dd43f0bbaf289829c5b70b09ff431c74688c2896a63f0fa", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/99ffb6c995d6d5c8b0001e8011451ef3adf3d72e3a24a8307c1f7b73490f364eda2a642a9b9584c2fbaa47a33af9c45994a754cc8296ed896b39be4aed3556cb", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6220385b05e6766fd8c7d6fd13724e8d097f6bace5871a17f7109c051a872b2e1341270ae3f3435757b186b2871a039d76380539338616a9066870ce0f658386"} 02:54:41 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 02:54:41 INFO - Writing to file /builds/slave/test/properties/blobber_files 02:54:41 INFO - Contents: 02:54:41 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/45d4f73447dddf249786c757b72f2db177621dfc48c81257818ac06276e1e099519bf9eca310cc5f7dd43f0bbaf289829c5b70b09ff431c74688c2896a63f0fa", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/99ffb6c995d6d5c8b0001e8011451ef3adf3d72e3a24a8307c1f7b73490f364eda2a642a9b9584c2fbaa47a33af9c45994a754cc8296ed896b39be4aed3556cb", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6220385b05e6766fd8c7d6fd13724e8d097f6bace5871a17f7109c051a872b2e1341270ae3f3435757b186b2871a039d76380539338616a9066870ce0f658386"} 02:54:41 INFO - Running post-run listener: copy_logs_to_upload_dir 02:54:41 INFO - Copying logs to upload dir... 02:54:41 INFO - mkdir: /builds/slave/test/build/upload/logs 02:54:41 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.318029 ========= master_lag: -0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-07-11 02:54:41.158754) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-11 02:54:41.162250) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/45d4f73447dddf249786c757b72f2db177621dfc48c81257818ac06276e1e099519bf9eca310cc5f7dd43f0bbaf289829c5b70b09ff431c74688c2896a63f0fa", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/99ffb6c995d6d5c8b0001e8011451ef3adf3d72e3a24a8307c1f7b73490f364eda2a642a9b9584c2fbaa47a33af9c45994a754cc8296ed896b39be4aed3556cb", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6220385b05e6766fd8c7d6fd13724e8d097f6bace5871a17f7109c051a872b2e1341270ae3f3435757b186b2871a039d76380539338616a9066870ce0f658386"} build_url:https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011317 build_url: 'https://queue.taskcluster.net/v1/task/OOI6Ot6wQhuGehkkWS-OaA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/45d4f73447dddf249786c757b72f2db177621dfc48c81257818ac06276e1e099519bf9eca310cc5f7dd43f0bbaf289829c5b70b09ff431c74688c2896a63f0fa", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/99ffb6c995d6d5c8b0001e8011451ef3adf3d72e3a24a8307c1f7b73490f364eda2a642a9b9584c2fbaa47a33af9c45994a754cc8296ed896b39be4aed3556cb", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6220385b05e6766fd8c7d6fd13724e8d097f6bace5871a17f7109c051a872b2e1341270ae3f3435757b186b2871a039d76380539338616a9066870ce0f658386"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-11 02:54:41.188437) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:54:41.188819) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1468229643.248694-1007736584 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004408 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:54:41.273554) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-11 02:54:41.273933) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-11 02:54:41.274276) ========= ========= Total master_lag: 0.15 =========