builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-048 starttime: 1471475121.2 results: success (0) buildid: 20160817143004 builduid: ae97d35ac4d7413faeb3878502af0c3c revision: 876756efc390115f1fde3b23e8369edd95eda403 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:21.200505) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:21.200962) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:21.201232) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:21.215665) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:21.215926) ========= 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=fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-17 16:05:22-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 37.8M=0s 2016-08-17 16:05:22 (37.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.123720 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:21.353416) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:21.353737) ========= 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=fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.025245 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:21.403596) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-17 16:05:21.403955) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 876756efc390115f1fde3b23e8369edd95eda403 --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 876756efc390115f1fde3b23e8369edd95eda403 --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=fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-17 16:05:23,085 truncating revision to first 12 chars 2016-08-17 16:05:23,085 Setting DEBUG logging. 2016-08-17 16:05:23,085 attempt 1/10 2016-08-17 16:05:23,085 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/876756efc390?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-17 16:05:24,297 unpacking tar archive at: fx-team-876756efc390/testing/mozharness/ program finished with exit code 0 elapsedTime=1.550899 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-17 16:05:22.969049) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:22.969379) ========= script_repo_revision: 876756efc390115f1fde3b23e8369edd95eda403 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:22.969798) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:22.970069) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-17 16:05:22.979778) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-08-17 16:05:22.980080) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:05:24 INFO - MultiFileLogger online at 20160817 16:05:24 in /builds/slave/test 16:05:24 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 16:05:24 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:05:24 INFO - {'append_to_log': False, 16:05:24 INFO - 'base_work_dir': '/builds/slave/test', 16:05:24 INFO - 'blob_upload_branch': 'Fx-Team', 16:05:24 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:05:24 INFO - 'branch': 'Fx-Team', 16:05:24 INFO - 'buildbot_json_path': 'buildprops.json', 16:05:24 INFO - 'config_files': ('talos/linux_config.py',), 16:05:24 INFO - 'default_actions': ('clobber', 16:05:24 INFO - 'read-buildbot-config', 16:05:24 INFO - 'download-and-extract', 16:05:24 INFO - 'populate-webroot', 16:05:24 INFO - 'create-virtualenv', 16:05:24 INFO - 'install', 16:05:24 INFO - 'run-tests'), 16:05:24 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:05:24 INFO - 'download_minidump_stackwalk': True, 16:05:24 INFO - 'download_symbols': 'ondemand', 16:05:24 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:05:24 INFO - 'tooltool.py': '/tools/tooltool.py', 16:05:24 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:05:24 INFO - '/tools/misc-python/virtualenv.py')}, 16:05:24 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:05:24 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:05:24 INFO - 'installer_path': 'installer.exe', 16:05:24 INFO - 'log_level': 'info', 16:05:24 INFO - 'log_name': 'talos', 16:05:24 INFO - 'log_to_console': True, 16:05:24 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:05:24 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:05:24 INFO - 'opt_config_files': (), 16:05:24 INFO - 'pip_index': False, 16:05:24 INFO - 'sps_profile': False, 16:05:24 INFO - 'sps_profile_interval': 0, 16:05:24 INFO - 'suite': 'dromaeojs-e10s', 16:05:24 INFO - 'system_bits': '32', 16:05:24 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:05:24 INFO - 'title': 'talos-linux64-ix-048', 16:05:24 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:05:24 INFO - 'use_talos_json': True, 16:05:24 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:05:24 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:05:24 INFO - 'work_dir': 'build'} 16:05:24 INFO - [mozharness: 2016-08-17 23:05:24.758533Z] Running clobber step. 16:05:24 INFO - Running pre-action listener: _resource_record_pre_action 16:05:24 INFO - Running main action method: clobber 16:05:24 INFO - rmtree: /builds/slave/test/build 16:05:24 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:05:25 INFO - Running post-action listener: _resource_record_post_action 16:05:25 INFO - [mozharness: 2016-08-17 23:05:25.748887Z] Finished clobber step (success) 16:05:25 INFO - [mozharness: 2016-08-17 23:05:25.748988Z] Running read-buildbot-config step. 16:05:25 INFO - Running pre-action listener: _resource_record_pre_action 16:05:25 INFO - Running main action method: read_buildbot_config 16:05:25 INFO - Using buildbot properties: 16:05:25 INFO - { 16:05:25 INFO - "project": "", 16:05:25 INFO - "product": "firefox", 16:05:25 INFO - "script_repo_revision": "production", 16:05:25 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 16:05:25 INFO - "repository": "", 16:05:25 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 16:05:25 INFO - "buildid": "20160817143004", 16:05:25 INFO - "pgo_build": "True", 16:05:25 INFO - "basedir": "/builds/slave/test", 16:05:25 INFO - "buildnumber": 1050, 16:05:25 INFO - "slavename": "talos-linux64-ix-048", 16:05:25 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:05:25 INFO - "platform": "ubuntu64_hw", 16:05:25 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 16:05:25 INFO - "branch": "fx-team", 16:05:25 INFO - "repo_path": "integration/fx-team", 16:05:25 INFO - "revision": "876756efc390115f1fde3b23e8369edd95eda403", 16:05:25 INFO - "stage_platform": "linux64-pgo", 16:05:25 INFO - "builduid": "ae97d35ac4d7413faeb3878502af0c3c", 16:05:25 INFO - "slavebuilddir": "test" 16:05:25 INFO - } 16:05:25 INFO - Found installer url https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 16:05:25 INFO - Running post-action listener: _resource_record_post_action 16:05:25 INFO - [mozharness: 2016-08-17 23:05:25.751434Z] Finished read-buildbot-config step (success) 16:05:25 INFO - [mozharness: 2016-08-17 23:05:25.751523Z] Running download-and-extract step. 16:05:25 INFO - Running pre-action listener: _resource_record_pre_action 16:05:25 INFO - Running main action method: download_and_extract 16:05:25 INFO - mkdir: /builds/slave/test/build/tests 16:05:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:25 INFO - trying https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 16:05:25 INFO - Downloading https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 16:05:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 16:05:26 INFO - Downloaded 1361 bytes. 16:05:26 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 16:05:26 INFO - Using the following test package requirements: 16:05:26 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 16:05:26 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:05:26 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 16:05:26 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:05:26 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 16:05:26 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:05:26 INFO - u'jsshell-linux-x86_64.zip'], 16:05:26 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:05:26 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 16:05:26 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 16:05:26 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:05:26 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 16:05:26 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:05:26 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 16:05:26 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:05:26 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 16:05:26 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:05:26 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 16:05:26 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 16:05:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:26 INFO - trying https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 16:05:26 INFO - Downloading https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 16:05:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:05:27 INFO - Downloaded 21903402 bytes. 16:05:27 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 16:05:31 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 16:05:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:31 INFO - trying https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 16:05:31 INFO - Downloading https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 16:05:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:05:32 INFO - Downloaded 21903402 bytes. 16:05:32 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 16:05: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:36 INFO - trying https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 16:05:36 INFO - Downloading https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 16:05:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 16:05:37 INFO - Downloaded 14413981 bytes. 16:05:37 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/tests 16:05:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:37 INFO - trying https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 16:05:37 INFO - Downloading https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 16:05:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 16:05:39 INFO - Downloaded 59553996 bytes. 16:05:39 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 16:05:39 INFO - mkdir: /builds/slave/test/properties 16:05:39 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:05:39 INFO - Writing to file /builds/slave/test/properties/build_url 16:05:39 INFO - Contents: 16:05:39 INFO - build_url:https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 16:05:40 INFO - Running post-action listener: _resource_record_post_action 16:05:40 INFO - Running post-action listener: set_extra_try_arguments 16:05:40 INFO - [mozharness: 2016-08-17 23:05:40.436616Z] Finished download-and-extract step (success) 16:05:40 INFO - [mozharness: 2016-08-17 23:05:40.436842Z] Running populate-webroot step. 16:05:40 INFO - Running pre-action listener: _resource_record_pre_action 16:05:40 INFO - Running main action method: populate_webroot 16:05:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:05:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:05:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:05:40 INFO - '--tppagecycles', 16:05:40 INFO - '7'], 16:05:40 INFO - 'tests': ['tsvgm']}}, 16:05:40 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:05:40 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:05:40 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:05:40 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:05:40 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:05:40 INFO - 'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:05:40 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:05:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:05:40 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:05:40 INFO - 'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['damp', 'tps']}, 16:05:40 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:05:40 INFO - 'tests': ['damp', 'tps']}, 16:05:40 INFO - 'g3': {'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['dromaeo_dom']}, 16:05:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:05:40 INFO - 'g4': {'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['basic_compositor_video']}, 16:05:40 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 16:05:40 INFO - 'other': {'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['a11yr', 16:05:40 INFO - 'ts_paint', 16:05:40 INFO - 'tpaint', 16:05:40 INFO - 'sessionrestore', 16:05:40 INFO - 'sessionrestore_no_auto_restore', 16:05:40 INFO - 'tabpaint']}, 16:05:40 INFO - 'other-e10s': {'tests': ['a11yr', 16:05:40 INFO - 'ts_paint', 16:05:40 INFO - 'tpaint', 16:05:40 INFO - 'sessionrestore', 16:05:40 INFO - 'sessionrestore_no_auto_restore', 16:05:40 INFO - 'tabpaint']}, 16:05:40 INFO - 'other-e10s_l64': {'tests': ['a11yr', 16:05:40 INFO - 'ts_paint', 16:05:40 INFO - 'tpaint', 16:05:40 INFO - 'sessionrestore', 16:05:40 INFO - 'sessionrestore_no_auto_restore', 16:05:40 INFO - 'tabpaint']}, 16:05:40 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 16:05:40 INFO - 'ts_paint', 16:05:40 INFO - 'tpaint', 16:05:40 INFO - 'sessionrestore', 16:05:40 INFO - 'sessionrestore_no_auto_restore', 16:05:40 INFO - 'tabpaint']}, 16:05:40 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['a11yr', 16:05:40 INFO - 'ts_paint', 16:05:40 INFO - 'tpaint', 16:05:40 INFO - 'sessionrestore', 16:05:40 INFO - 'sessionrestore_no_auto_restore', 16:05:40 INFO - 'tabpaint']}, 16:05:40 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['a11yr', 16:05:40 INFO - 'ts_paint', 16:05:40 INFO - 'tpaint', 16:05:40 INFO - 'sessionrestore', 16:05:40 INFO - 'sessionrestore_no_auto_restore', 16:05:40 INFO - 'tabpaint']}, 16:05:40 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['tsvgx', 16:05:40 INFO - 'tsvgr_opacity', 16:05:40 INFO - 'tart', 16:05:40 INFO - 'tscrollx', 16:05:40 INFO - 'cart']}, 16:05:40 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:05:40 INFO - 'tsvgr_opacity', 16:05:40 INFO - 'tart', 16:05:40 INFO - 'tscrollx', 16:05:40 INFO - 'cart']}, 16:05:40 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:05:40 INFO - 'talos_options': ['--disable-e10s'], 16:05:40 INFO - 'tests': ['tp5o']}, 16:05:40 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:05:40 INFO - 'tests': ['tp5o']}, 16:05:40 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:05:40 INFO - 'talos_options': ['--disable-e10s', 16:05:40 INFO - '--xperf_path', 16:05:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:05:40 INFO - 'tests': ['tp5n']}, 16:05:40 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:05:40 INFO - 'talos_options': ['--xperf_path', 16:05:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:05:40 INFO - 'tests': ['tp5n']}}, 16:05:40 INFO - 'talos.zip': {'path': '', 16:05:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:05:40 INFO - Running post-action listener: _resource_record_post_action 16:05:40 INFO - [mozharness: 2016-08-17 23:05:40.458238Z] Finished populate-webroot step (success) 16:05:40 INFO - [mozharness: 2016-08-17 23:05:40.458327Z] Running create-virtualenv step. 16:05:40 INFO - Running pre-action listener: _resource_record_pre_action 16:05:40 INFO - Running main action method: create_virtualenv 16:05:40 INFO - Creating virtualenv /builds/slave/test/build/venv 16:05:40 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 16:05:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:05:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:05:40 INFO - Using real prefix '/usr' 16:05:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:05:41 INFO - Installing distribute.............................................................................................................................................................................................done. 16:05:43 INFO - Installing pip.................done. 16:05:43 INFO - Return code: 0 16:05:43 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:05:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:05:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:05:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 16:05:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:05:43 INFO - Using env: {'DISPLAY': ':0', 16:05:43 INFO - 'HOME': '/home/cltbld', 16:05:43 INFO - 'LANG': 'en_US.UTF-8', 16:05:43 INFO - 'LANGUAGE': 'en_US:en', 16:05:43 INFO - 'LOGNAME': 'cltbld', 16:05:43 INFO - 'MAIL': '/var/mail/cltbld', 16:05:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:05:43 INFO - 'MOZ_NO_REMOTE': '1', 16:05:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:05:43 INFO - 'NO_EM_RESTART': '1', 16:05:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:05:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:05:43 INFO - 'PWD': '/builds/slave/test', 16:05:43 INFO - 'SHELL': '/bin/bash', 16:05:43 INFO - 'SHLVL': '1', 16:05:43 INFO - 'TERM': 'linux', 16:05:43 INFO - 'TMOUT': '86400', 16:05:43 INFO - 'USER': 'cltbld', 16:05:43 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:05:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:05:43 INFO - '_': '/tools/buildbot/bin/python'} 16:05:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:05:43 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 16:05:43 INFO - Cleaning up... 16:05:43 INFO - Return code: 0 16:05:43 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:05:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:05:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:05:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 16:05:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 16:05:43 INFO - Using env: {'DISPLAY': ':0', 16:05:43 INFO - 'HOME': '/home/cltbld', 16:05:43 INFO - 'LANG': 'en_US.UTF-8', 16:05:43 INFO - 'LANGUAGE': 'en_US:en', 16:05:43 INFO - 'LOGNAME': 'cltbld', 16:05:43 INFO - 'MAIL': '/var/mail/cltbld', 16:05:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:05:43 INFO - 'MOZ_NO_REMOTE': '1', 16:05:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:05:43 INFO - 'NO_EM_RESTART': '1', 16:05:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:05:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:05:43 INFO - 'PWD': '/builds/slave/test', 16:05:43 INFO - 'SHELL': '/bin/bash', 16:05:43 INFO - 'SHLVL': '1', 16:05:43 INFO - 'TERM': 'linux', 16:05:43 INFO - 'TMOUT': '86400', 16:05:43 INFO - 'USER': 'cltbld', 16:05:43 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:05:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:05:43 INFO - '_': '/tools/buildbot/bin/python'} 16:05:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:05:43 INFO - Downloading/unpacking psutil>=3.1.1 16:05:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:05:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:05:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:05:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:05:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:05:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:05:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:05:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:05:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:05:45 INFO - Installing collected packages: psutil 16:05:45 INFO - Running setup.py install for psutil 16:05:45 INFO - building 'psutil._psutil_linux' extension 16:05:45 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 16:05:45 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 16:05:45 INFO - building 'psutil._psutil_posix' extension 16:05:45 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 16:05:45 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 16:05:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:05:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:05:45 INFO - Successfully installed psutil 16:05:45 INFO - Cleaning up... 16:05:46 INFO - Return code: 0 16:05:46 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:05:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:05:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:05:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:46 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 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:05:46 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 16:05:46 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 16:05:46 INFO - Using env: {'DISPLAY': ':0', 16:05:46 INFO - 'HOME': '/home/cltbld', 16:05:46 INFO - 'LANG': 'en_US.UTF-8', 16:05:46 INFO - 'LANGUAGE': 'en_US:en', 16:05:46 INFO - 'LOGNAME': 'cltbld', 16:05:46 INFO - 'MAIL': '/var/mail/cltbld', 16:05:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:05:46 INFO - 'MOZ_NO_REMOTE': '1', 16:05:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:05:46 INFO - 'NO_EM_RESTART': '1', 16:05:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:05:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:05:46 INFO - 'PWD': '/builds/slave/test', 16:05:46 INFO - 'SHELL': '/bin/bash', 16:05:46 INFO - 'SHLVL': '1', 16:05:46 INFO - 'TERM': 'linux', 16:05:46 INFO - 'TMOUT': '86400', 16:05:46 INFO - 'USER': 'cltbld', 16:05:46 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:05:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:05:46 INFO - '_': '/tools/buildbot/bin/python'} 16:05:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:05:46 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:05:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:05:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:05:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:05:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:05:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:05:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:05:48 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:05:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:05:48 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:05:48 INFO - Installing collected packages: mozsystemmonitor 16:05:48 INFO - Running setup.py install for mozsystemmonitor 16:05:48 INFO - Successfully installed mozsystemmonitor 16:05:48 INFO - Cleaning up... 16:05:48 INFO - Return code: 0 16:05:48 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:05:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:05:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:05:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:48 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 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:05:48 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 16:05:48 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 16:05:48 INFO - Using env: {'DISPLAY': ':0', 16:05:48 INFO - 'HOME': '/home/cltbld', 16:05:48 INFO - 'LANG': 'en_US.UTF-8', 16:05:48 INFO - 'LANGUAGE': 'en_US:en', 16:05:48 INFO - 'LOGNAME': 'cltbld', 16:05:48 INFO - 'MAIL': '/var/mail/cltbld', 16:05:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:05:48 INFO - 'MOZ_NO_REMOTE': '1', 16:05:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:05:48 INFO - 'NO_EM_RESTART': '1', 16:05:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:05:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:05:48 INFO - 'PWD': '/builds/slave/test', 16:05:48 INFO - 'SHELL': '/bin/bash', 16:05:48 INFO - 'SHLVL': '1', 16:05:48 INFO - 'TERM': 'linux', 16:05:48 INFO - 'TMOUT': '86400', 16:05:48 INFO - 'USER': 'cltbld', 16:05:48 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:05:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:05:48 INFO - '_': '/tools/buildbot/bin/python'} 16:05:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:05:48 INFO - Downloading/unpacking jsonschema==2.5.1 16:05:48 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 16:05:48 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 16:05:48 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 16:05:48 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 16:05:48 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 16:05:48 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 16:05:50 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:05:50 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:05:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:05:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:05:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:05:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:05:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:05:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:05:50 INFO - Downloading functools32-3.2.3-2.tar.gz 16:05:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:05:50 INFO - warning: no files found matching '*.txt' 16:05:50 INFO - no previously-included directories found matching 'build' 16:05:50 INFO - no previously-included directories found matching 'dist' 16:05:50 INFO - no previously-included directories found matching '.git*' 16:05:50 INFO - Installing collected packages: jsonschema, functools32 16:05:50 INFO - Running setup.py install for functools32 16:05:50 INFO - warning: no files found matching '*.txt' 16:05:50 INFO - no previously-included directories found matching 'build' 16:05:50 INFO - no previously-included directories found matching 'dist' 16:05:50 INFO - no previously-included directories found matching '.git*' 16:05:50 INFO - Successfully installed jsonschema functools32 16:05:50 INFO - Cleaning up... 16:05:50 INFO - Return code: 0 16:05:50 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:05:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:05:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:05:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:05:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 16:05:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 16:05:50 INFO - Using env: {'DISPLAY': ':0', 16:05:50 INFO - 'HOME': '/home/cltbld', 16:05:50 INFO - 'LANG': 'en_US.UTF-8', 16:05:50 INFO - 'LANGUAGE': 'en_US:en', 16:05:50 INFO - 'LOGNAME': 'cltbld', 16:05:50 INFO - 'MAIL': '/var/mail/cltbld', 16:05:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:05:50 INFO - 'MOZ_NO_REMOTE': '1', 16:05:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:05:50 INFO - 'NO_EM_RESTART': '1', 16:05:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:05:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:05:50 INFO - 'PWD': '/builds/slave/test', 16:05:50 INFO - 'SHELL': '/bin/bash', 16:05:50 INFO - 'SHLVL': '1', 16:05:50 INFO - 'TERM': 'linux', 16:05:50 INFO - 'TMOUT': '86400', 16:05:50 INFO - 'USER': 'cltbld', 16:05:50 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:05:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:05:50 INFO - '_': '/tools/buildbot/bin/python'} 16:05:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:05:51 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:05:51 INFO - Cleaning up... 16:05:51 INFO - Return code: 0 16:05:51 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:05:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:05:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:05:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:51 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 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:05:51 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 16:05:51 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 16:05:51 INFO - Using env: {'DISPLAY': ':0', 16:05:51 INFO - 'HOME': '/home/cltbld', 16:05:51 INFO - 'LANG': 'en_US.UTF-8', 16:05:51 INFO - 'LANGUAGE': 'en_US:en', 16:05:51 INFO - 'LOGNAME': 'cltbld', 16:05:51 INFO - 'MAIL': '/var/mail/cltbld', 16:05:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:05:51 INFO - 'MOZ_NO_REMOTE': '1', 16:05:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:05:51 INFO - 'NO_EM_RESTART': '1', 16:05:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:05:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:05:51 INFO - 'PWD': '/builds/slave/test', 16:05:51 INFO - 'SHELL': '/bin/bash', 16:05:51 INFO - 'SHLVL': '1', 16:05:51 INFO - 'TERM': 'linux', 16:05:51 INFO - 'TMOUT': '86400', 16:05:51 INFO - 'USER': 'cltbld', 16:05:51 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:05:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:05:51 INFO - '_': '/tools/buildbot/bin/python'} 16:05:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:05:51 INFO - Downloading/unpacking blobuploader==1.2.4 16:05:51 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 16:05:51 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 16:05:51 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 16:05:51 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 16:05:51 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 16:05:51 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 16:05:53 INFO - Downloading blobuploader-1.2.4.tar.gz 16:05:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:05:53 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:05:53 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 16:05:53 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 16:05:53 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 16:05:53 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 16:05:53 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 16:05:53 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 16:05:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:05:53 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:05:53 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 16:05:53 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 16:05:53 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 16:05:53 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 16:05:53 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 16:05:53 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 16:05:54 INFO - Downloading docopt-0.6.1.tar.gz 16:05:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:05:54 INFO - Installing collected packages: blobuploader, requests, docopt 16:05:54 INFO - Running setup.py install for blobuploader 16:05:54 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:05:54 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:05:54 INFO - Running setup.py install for requests 16:05:54 INFO - Running setup.py install for docopt 16:05:54 INFO - Successfully installed blobuploader requests docopt 16:05:54 INFO - Cleaning up... 16:05:54 INFO - Return code: 0 16:05:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:05:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:05:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:05:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:54 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 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:05:54 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 16:05:54 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 16:05:54 INFO - Using env: {'DISPLAY': ':0', 16:05:54 INFO - 'HOME': '/home/cltbld', 16:05:54 INFO - 'LANG': 'en_US.UTF-8', 16:05:54 INFO - 'LANGUAGE': 'en_US:en', 16:05:54 INFO - 'LOGNAME': 'cltbld', 16:05:54 INFO - 'MAIL': '/var/mail/cltbld', 16:05:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:05:54 INFO - 'MOZ_NO_REMOTE': '1', 16:05:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:05:54 INFO - 'NO_EM_RESTART': '1', 16:05:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:05:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:05:54 INFO - 'PWD': '/builds/slave/test', 16:05:54 INFO - 'SHELL': '/bin/bash', 16:05:54 INFO - 'SHLVL': '1', 16:05:54 INFO - 'TERM': 'linux', 16:05:54 INFO - 'TMOUT': '86400', 16:05:54 INFO - 'USER': 'cltbld', 16:05:54 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:05:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:05:54 INFO - '_': '/tools/buildbot/bin/python'} 16:05:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:05:55 INFO - Running setup.py (path:/tmp/pip-RSge0w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:05:55 INFO - Running setup.py (path:/tmp/pip-7oZ1l_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:05:55 INFO - Running setup.py (path:/tmp/pip-muZN7n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:05:55 INFO - Running setup.py (path:/tmp/pip-QsUkKA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:05:55 INFO - Running setup.py (path:/tmp/pip-KOO2Tg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:05:55 INFO - Running setup.py (path:/tmp/pip-DWYC_i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:05:55 INFO - Running setup.py (path:/tmp/pip-alYxKM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:05:55 INFO - Running setup.py (path:/tmp/pip-vlqwED-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:05:55 INFO - Running setup.py (path:/tmp/pip-PwrXfu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:05:55 INFO - Running setup.py (path:/tmp/pip-lNAmcu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:05:55 INFO - Running setup.py (path:/tmp/pip-VQP0Ai-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:05:55 INFO - Running setup.py (path:/tmp/pip-Elzw00-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:05:55 INFO - Running setup.py (path:/tmp/pip-uLGhPb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:05:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:05:55 INFO - Running setup.py (path:/tmp/pip-aqNEpn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:05:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:05:56 INFO - Running setup.py (path:/tmp/pip-OHdVnd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:05:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:05:56 INFO - Running setup.py (path:/tmp/pip-nP7UNN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:05:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:05:56 INFO - Running setup.py (path:/tmp/pip-hL11Z6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:05:56 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:05:56 INFO - Running setup.py install for manifestparser 16:05:56 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:05:56 INFO - Running setup.py install for mozcrash 16:05:56 INFO - Running setup.py install for mozdebug 16:05:56 INFO - Running setup.py install for mozdevice 16:05:56 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:05:56 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:05:56 INFO - Running setup.py install for mozfile 16:05:56 INFO - Running setup.py install for mozhttpd 16:05:56 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:05:56 INFO - Running setup.py install for mozinfo 16:05:56 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:05:56 INFO - Running setup.py install for mozInstall 16:05:57 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Running setup.py install for mozleak 16:05:57 INFO - Running setup.py install for mozlog 16:05:57 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Running setup.py install for moznetwork 16:05:57 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Running setup.py install for mozprocess 16:05:57 INFO - Running setup.py install for mozprofile 16:05:57 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Running setup.py install for mozrunner 16:05:57 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:05:57 INFO - Running setup.py install for mozscreenshot 16:05:57 INFO - Running setup.py install for moztest 16:05:57 INFO - Running setup.py install for mozversion 16:05:58 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:05:58 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:05:58 INFO - Cleaning up... 16:05:58 INFO - Return code: 0 16:05:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:05:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:05:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:05:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:05:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:05:58 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 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:05:58 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 16:05:58 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 16:05:58 INFO - Using env: {'DISPLAY': ':0', 16:05:58 INFO - 'HOME': '/home/cltbld', 16:05:58 INFO - 'LANG': 'en_US.UTF-8', 16:05:58 INFO - 'LANGUAGE': 'en_US:en', 16:05:58 INFO - 'LOGNAME': 'cltbld', 16:05:58 INFO - 'MAIL': '/var/mail/cltbld', 16:05:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:05:58 INFO - 'MOZ_NO_REMOTE': '1', 16:05:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:05:58 INFO - 'NO_EM_RESTART': '1', 16:05:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:05:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:05:58 INFO - 'PWD': '/builds/slave/test', 16:05:58 INFO - 'SHELL': '/bin/bash', 16:05:58 INFO - 'SHLVL': '1', 16:05:58 INFO - 'TERM': 'linux', 16:05:58 INFO - 'TMOUT': '86400', 16:05:58 INFO - 'USER': 'cltbld', 16:05:58 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:05:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:05:58 INFO - '_': '/tools/buildbot/bin/python'} 16:05:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:05:58 INFO - Running setup.py (path:/tmp/pip-Xwr_oi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:05:58 INFO - Running setup.py (path:/tmp/pip-xj96Dp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:05:58 INFO - Running setup.py (path:/tmp/pip-L2yEis-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:05:58 INFO - Running setup.py (path:/tmp/pip-918urC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:05:58 INFO - Running setup.py (path:/tmp/pip-yBMplb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:05:58 INFO - Running setup.py (path:/tmp/pip-9en773-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:05:58 INFO - Running setup.py (path:/tmp/pip-Qo2Qj0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:05:58 INFO - Running setup.py (path:/tmp/pip-10LBck-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:05:58 INFO - Running setup.py (path:/tmp/pip-wv9wUA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:05:58 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)) 16:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:05:58 INFO - Running setup.py (path:/tmp/pip-lJVoAk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:05:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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)) 16:05:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:05:59 INFO - Running setup.py (path:/tmp/pip-YRmqUP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:05:59 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)) 16:05:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:05:59 INFO - Running setup.py (path:/tmp/pip-vnGXNL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:05:59 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)) 16:05:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:05:59 INFO - Running setup.py (path:/tmp/pip-xqXHka-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:05:59 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)) 16:05:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:05:59 INFO - Running setup.py (path:/tmp/pip-ZpvgSl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:05:59 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)) 16:05:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:05:59 INFO - Running setup.py (path:/tmp/pip-isGnVn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:05:59 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)) 16:05:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:05:59 INFO - Running setup.py (path:/tmp/pip-8jhiXI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:05:59 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)) 16:05:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:05:59 INFO - Running setup.py (path:/tmp/pip-Z2Lqbc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:05:59 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)) 16:05:59 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)) 16:05:59 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)) 16:05:59 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)) 16:05:59 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)) 16:05:59 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)) 16:05:59 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:05:59 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 16:05:59 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 16:05:59 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 16:05:59 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 16:05:59 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 16:05:59 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 16:06:01 INFO - Downloading blessings-1.6.tar.gz 16:06:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:06:01 INFO - Installing collected packages: blessings 16:06:01 INFO - Running setup.py install for blessings 16:06:01 INFO - Successfully installed blessings 16:06:01 INFO - Cleaning up... 16:06:01 INFO - Return code: 0 16:06:01 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:06:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:06:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:06:01 INFO - Reading from file tmpfile_stdout 16:06:01 INFO - Current package versions: 16:06:01 INFO - argparse == 1.2.1 16:06:01 INFO - blessings == 1.6 16:06:01 INFO - blobuploader == 1.2.4 16:06:01 INFO - docopt == 0.6.1 16:06:01 INFO - functools32 == 3.2.3-2 16:06:01 INFO - jsonschema == 2.5.1 16:06:01 INFO - manifestparser == 1.1 16:06:01 INFO - mozInstall == 1.12 16:06:01 INFO - mozcrash == 0.17 16:06:01 INFO - mozdebug == 0.1 16:06:01 INFO - mozdevice == 0.48 16:06:01 INFO - mozfile == 1.2 16:06:01 INFO - mozhttpd == 0.7 16:06:01 INFO - mozinfo == 0.9 16:06:01 INFO - mozleak == 0.1 16:06:01 INFO - mozlog == 3.3 16:06:01 INFO - moznetwork == 0.27 16:06:01 INFO - mozprocess == 0.23 16:06:01 INFO - mozprofile == 0.28 16:06:01 INFO - mozrunner == 6.12 16:06:01 INFO - mozscreenshot == 0.1 16:06:01 INFO - mozsystemmonitor == 0.3 16:06:01 INFO - moztest == 0.7 16:06:01 INFO - mozversion == 1.4 16:06:01 INFO - psutil == 3.1.1 16:06:01 INFO - requests == 1.2.3 16:06:01 INFO - wsgiref == 0.1.2 16:06:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:06:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:06:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:06:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:06:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:06:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:06:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:06:01 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 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:06:01 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 16:06:01 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 16:06:01 INFO - Using env: {'DISPLAY': ':0', 16:06:01 INFO - 'HOME': '/home/cltbld', 16:06:01 INFO - 'LANG': 'en_US.UTF-8', 16:06:01 INFO - 'LANGUAGE': 'en_US:en', 16:06:01 INFO - 'LOGNAME': 'cltbld', 16:06:01 INFO - 'MAIL': '/var/mail/cltbld', 16:06:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:06:01 INFO - 'MOZ_NO_REMOTE': '1', 16:06:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:06:01 INFO - 'NO_EM_RESTART': '1', 16:06:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:06:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:06:01 INFO - 'PWD': '/builds/slave/test', 16:06:01 INFO - 'SHELL': '/bin/bash', 16:06:01 INFO - 'SHLVL': '1', 16:06:01 INFO - 'TERM': 'linux', 16:06:01 INFO - 'TMOUT': '86400', 16:06:01 INFO - 'USER': 'cltbld', 16:06:01 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:06:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:06:01 INFO - '_': '/tools/buildbot/bin/python'} 16:06:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 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)) 16:06:02 INFO - Cleaning up... 16:06:02 INFO - Return code: 0 16:06:02 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:06:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:06:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:06:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:06:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:06:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:06:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:06:02 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 0x7fd18de37f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x181e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18eb850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, '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': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', '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 16:06:02 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 16:06:02 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 16:06:02 INFO - Using env: {'DISPLAY': ':0', 16:06:02 INFO - 'HOME': '/home/cltbld', 16:06:02 INFO - 'LANG': 'en_US.UTF-8', 16:06:02 INFO - 'LANGUAGE': 'en_US:en', 16:06:02 INFO - 'LOGNAME': 'cltbld', 16:06:02 INFO - 'MAIL': '/var/mail/cltbld', 16:06:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:06:02 INFO - 'MOZ_NO_REMOTE': '1', 16:06:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:06:02 INFO - 'NO_EM_RESTART': '1', 16:06:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:06:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:06:02 INFO - 'PWD': '/builds/slave/test', 16:06:02 INFO - 'SHELL': '/bin/bash', 16:06:02 INFO - 'SHLVL': '1', 16:06:02 INFO - 'TERM': 'linux', 16:06:02 INFO - 'TMOUT': '86400', 16:06:02 INFO - 'USER': 'cltbld', 16:06:02 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:06:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:06:02 INFO - '_': '/tools/buildbot/bin/python'} 16:06:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:06:02 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:06:02 INFO - Cleaning up... 16:06:02 INFO - Return code: 0 16:06:02 INFO - Running post-action listener: _resource_record_post_action 16:06:02 INFO - Running post-action listener: _start_resource_monitoring 16:06:02 INFO - Starting resource monitoring. 16:06:02 INFO - [mozharness: 2016-08-17 23:06:02.390575Z] Finished create-virtualenv step (success) 16:06:02 INFO - [mozharness: 2016-08-17 23:06:02.391069Z] Running install step. 16:06:02 INFO - Running pre-action listener: _resource_record_pre_action 16:06:02 INFO - Running main action method: install 16:06:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:06:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:06:02 INFO - Reading from file tmpfile_stdout 16:06:02 INFO - Detecting whether we're running mozinstall >=1.0... 16:06:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:06:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:06:02 INFO - Reading from file tmpfile_stdout 16:06:02 INFO - Output received: 16:06:02 INFO - Usage: mozinstall [options] installer 16:06:02 INFO - Options: 16:06:02 INFO - -h, --help show this help message and exit 16:06:02 INFO - -d DEST, --destination=DEST 16:06:02 INFO - Directory to install application into. [default: 16:06:02 INFO - "/builds/slave/test"] 16:06:02 INFO - --app=APP Application being installed. [default: firefox] 16:06:02 INFO - mkdir: /builds/slave/test/build/application 16:06:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 16:06:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 16:06:19 INFO - Reading from file tmpfile_stdout 16:06:19 INFO - Output received: 16:06:19 INFO - /builds/slave/test/build/application/firefox/firefox 16:06:19 INFO - Running post-action listener: _resource_record_post_action 16:06:19 INFO - [mozharness: 2016-08-17 23:06:19.681258Z] Finished install step (success) 16:06:19 INFO - [mozharness: 2016-08-17 23:06:19.681602Z] Running run-tests step. 16:06:19 INFO - Running pre-action listener: _resource_record_pre_action 16:06:19 INFO - Running main action method: run_tests 16:06:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:06:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:06:19 INFO - Python 2.7.3 16:06:19 INFO - Return code: 0 16:06:19 INFO - grabbing minidump binary from tooltool 16:06:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:06:19 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 0x18e6370>, '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 0x18e98f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18e9d80>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:06:19 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 16:06:19 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 16:06:19 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 16:06:19 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:06:19 INFO - Return code: 0 16:06:19 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:06:19 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:06:19 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:06:19 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:06:19 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:06:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-048', '--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 16:06:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-048 --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 16:06:19 INFO - Using env: {'DISPLAY': ':0', 16:06:19 INFO - 'HOME': '/home/cltbld', 16:06:19 INFO - 'LANG': 'en_US.UTF-8', 16:06:19 INFO - 'LANGUAGE': 'en_US:en', 16:06:19 INFO - 'LOGNAME': 'cltbld', 16:06:19 INFO - 'MAIL': '/var/mail/cltbld', 16:06:19 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:06:19 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:06:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:06:19 INFO - 'MOZ_NO_REMOTE': '1', 16:06:19 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:06:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:06:19 INFO - 'NO_EM_RESTART': '1', 16:06:19 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:06:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:06:19 INFO - 'PWD': '/builds/slave/test', 16:06:19 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:06:19 INFO - 'SHELL': '/bin/bash', 16:06:19 INFO - 'SHLVL': '1', 16:06:19 INFO - 'TERM': 'linux', 16:06:19 INFO - 'TMOUT': '86400', 16:06:19 INFO - 'USER': 'cltbld', 16:06:19 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432', 16:06:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:06:19 INFO - '_': '/tools/buildbot/bin/python'} 16:06:19 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-048', '--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 16:06:19 INFO - mozversion application_buildid: 20160817143004 16:06:19 INFO - mozversion application_changeset: 876756efc390115f1fde3b23e8369edd95eda403 16:06:19 INFO - mozversion application_display_name: Nightly 16:06:19 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:06:19 INFO - mozversion application_name: Firefox 16:06:19 INFO - mozversion application_remotingname: firefox 16:06:19 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 16:06:19 INFO - mozversion application_vendor: Mozilla 16:06:19 INFO - mozversion application_version: 51.0a1 16:06:19 INFO - mozversion platform_buildid: 20160817143004 16:06:19 INFO - mozversion platform_changeset: 876756efc390115f1fde3b23e8369edd95eda403 16:06:19 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 16:06:19 INFO - mozversion platform_version: 51.0a1 16:06:19 INFO - using testdate: 1471475179 16:06:19 INFO - actual date: 1471475179 16:06:19 INFO - starting webserver on 'localhost:36990' 16:06:19 INFO - SUITE-START | Running 2 tests 16:06:19 INFO - TEST-START | dromaeo_css 16:06:19 INFO - operating with platform_type : linux_ 16:06:19 INFO - Initialising browser for dromaeo_css test... 16:06:19 INFO - TEST-INFO | started process 29908 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpDnDwlQ/profile http://localhost:36990/getInfo.html) 16:06:24 INFO - PROCESS | 29908 | __metrics Screen width/height:1600/1200 16:06:24 INFO - PROCESS | 29908 | colorDepth:24 16:06:24 INFO - PROCESS | 29908 | Browser inner width/height: 1024/697 16:06:24 INFO - PROCESS | 29908 | __metrics 16:06:25 ERROR - PROCESS | 29908 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 16:06:26 INFO - TEST-INFO | 29908: exit 0 16:06:26 INFO - Browser initialized. 16:06:26 INFO - Running cycle 1/1 for dromaeo_css test... 16:06:26 INFO - TEST-INFO | started process 30028 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpDnDwlQ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:06:38 INFO - PROCESS | 30028 | RSS: Main: 163028992 16:06:38 INFO - PROCESS | 30028 | 16:07:27 INFO - PROCESS | 30028 | 1471475247696 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] 16:09:36 INFO - PROCESS | 30028 | Cycle 1(1): loaded http://localhost:36990/tests/dromaeo/cssquery-dojo.html (next: http://localhost:36990/tests/dromaeo/cssquery-ext.html) 16:09:38 INFO - PROCESS | 30028 | RSS: Main: 166510592 16:09:38 INFO - PROCESS | 30028 | 16:12:40 INFO - PROCESS | 30028 | Cycle 1(1): loaded http://localhost:36990/tests/dromaeo/cssquery-ext.html (next: http://localhost:36990/tests/dromaeo/cssquery-jquery.html) 16:12:41 INFO - PROCESS | 30028 | RSS: Main: 165040128 16:12:41 INFO - PROCESS | 30028 | 16:15:42 INFO - PROCESS | 30028 | Cycle 1(1): loaded http://localhost:36990/tests/dromaeo/cssquery-jquery.html (next: http://localhost:36990/tests/dromaeo/cssquery-mootools.html) 16:15:43 INFO - PROCESS | 30028 | RSS: Main: 166203392 16:15:43 INFO - PROCESS | 30028 | 16:18:45 INFO - PROCESS | 30028 | Cycle 1(1): loaded http://localhost:36990/tests/dromaeo/cssquery-mootools.html (next: http://localhost:36990/tests/dromaeo/cssquery-prototype.html) 16:18:46 INFO - PROCESS | 30028 | RSS: Main: 163651584 16:18:46 INFO - PROCESS | 30028 | 16:21:48 INFO - PROCESS | 30028 | Cycle 1(1): loaded http://localhost:36990/tests/dromaeo/cssquery-prototype.html (next: http://localhost:36990/tests/dromaeo/cssquery-yui.html) 16:21:49 INFO - PROCESS | 30028 | RSS: Main: 166563840 16:21:49 INFO - PROCESS | 30028 | 16:24:51 INFO - PROCESS | 30028 | Cycle 1(1): loaded http://localhost:36990/tests/dromaeo/cssquery-yui.html (next: http://localhost:36990/tests/dromaeo/cssquery-dojo.html) 16:24:52 INFO - PROCESS | 30028 | RSS: Main: 166686720 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - PROCESS | 30028 | __start_tp_report 16:24:52 INFO - PROCESS | 30028 | _x_x_mozilla_page_load 16:24:52 INFO - PROCESS | 30028 | _x_x_mozilla_page_load_details 16:24:52 INFO - PROCESS | 30028 | |i|pagename|runs| 16:24:52 INFO - PROCESS | 30028 | |0;dojo.html;3028.2126647071764;3049.237690577356;3060.3879224155176;3066.294752206992;3086.8302243376606;5218.32161818964;5318.335208098988;5411.24242606035;5432.13085906255;5440.999999999995;5261.447548007462;5343.679379237248;5356.598255130862;5357.598180136486;5366.302380690515;4790.904181916351;4795.568398844103;4826.1795494765975;4849.224124140138;4871.512848715136;4720.669553131283;4737.242041273397;4745.810167593292;4749.287606858964;4765;706.2377228419998;4796.976015119937;4809.78355973982;4817.253325734517;4870.074685809703;4702.8118875244945;4759.262314341283;4776.80892764289;4789.688670236458;4793.808247670124;4692.859214223578;4697.060587882403;4715.622750179978;4719.244920812688;4742.976285118552;5149.201873709581;5202.06362854686;5230.267762513251;5235.816746413857;5300.178472336794;5576.581756368248;5605.607607467479;5622.409646987089;5686.800961966353;5714.45712657301;5692.402297758758;5702.344230413472;5709.857253568694;5725.341585717654;5734.197212390269;5128.435872054071;5327.227552004976;5335.599830012726;5348.759305831208;5393.7572809223675;5674.4892959633835;5702.372738998707;5732.426757324234;5766.106253530709;5821.15593238978;5513.696746678891;5529.668219906738;5551.056320425538;5559.11054231321;5574.470425309589;5523.28197334344;5619.297587801525;5622.522085622768;5627.240322556402;5643.576731745054;5573.191887176336;5596.580256480699;5660.745266463019;5763.0202865512965;5798.275215598051;5643.5767317451355;5706.80026199081;5711.400302968212;5714.11431228152;5714.828555143353;4246.044639955985;4430;4435.866923992286;4438.423005009393;4475.910481790346;3794.905127371783;3848.980755096263;3852.210296889131;3859.7877116758846;3886.3198940185353;5225.790968361299;5274.604404669665;5287.682739035593;5297.337832770903;5300.363956325188;5469.644473109235;5597.972010140004;5619.80330688424;5637.182608521742;5657.688827114548;5317.175837745156;5347.1979203119845;5381.246625472437;5428.511433970962;5435.347758269033;4883.51164883516;4901.313816065754;4920.138975679313;4922.261660750844;4958.157113290749;5774.566907481955;5863.355030946593;5876.41235876409;5894.115882617556;5919.467247947706;5675.290588676416;5752.7698892043845;5772.5381969441505;5810.302763668386;5815.011448053757;5926.644401335933;5952.851178720393;5953.672548009901;5955;5961.8807623846415;5457.099578569491;5493.725313734377;5547.195656629847;5608.943910560843;5613.129964855454;5693.5445164387575;5717.456841600041;5721.885562288814;5759.1649210865025;5763.049096898964;5523.558115350682;5559.749811258584;5563.248961390161;5573.637713548606;5589.552835773047;5375.354957405137;5375.381831089475;5509.256250406304;5518.806841760519;5532.778688852401;5396.109641909198;5440.183972404171;5442.047641662773;5463.644863083887;5520.779168833202;5441.347038355423;5472.507474327171;5498.1752737089755;5522.475364840334;5528.806491772769;5310.2831117798605;5404.108322126962;5405.405405405481;5421.322334708161;5455.099908515051 16:24:52 INFO - PROCESS | 30028 | |1;ext.html;576.5301279457242;576.8557860534867;588.6115163991766;591.9999999999999;622.9813105606834;40218;45260.32109518356;45313.77343113288;45317.546824531826;45434;44683.77658111705;45118.54881451184;45190.77404612972;45290.320645190346;45365;8861;9005.279577633806;9045.185933266037;9101.499417532033;9119.726408207764;8960.462372257685;9014.323925705565;9081.091890810932;9097.317701172406;9100.317476189279;9144.451332920013;9174.908250917471;9181.58682859273;9193.678221262257;9206.309526785484;9057.50183739894;9088.50013249271;9152.313576481723;9166;9173.40372875761;8978.955105224497;9009.549522523914;9042.502662353569;9048.321375896834;9055.275577953747;42451.57548424538;42933.57066429327;42934.06258280307;42937.35593966093;43022;2599.8180127391092;3229.5963004624423;3314.685104915053;3454.464557993515;3555.253396786678;29206.853965730035;29663.70336296631;31425.423796101546;31934.520982185284;32042;4076.103257283393;4197.496300443966;4214.7681877496725;4270.871873843789;4317.050248945227;304705;306386;307036;307644;307703;35162.29675406529;35495.4675679865;35509.28981420357;35528.289434211685;35751.28497430037;36937.261254775294;37038.629613704055;37073.10732373116;37296.50813967411;37446.43830342547;17216.483505494856;17433.389831356097;17439.604831613695;17644.206010729293;17669.20488578017;13283;13394.665133371549;13402.597922062354;13432.126911750705;13433.39549720265;19311.22755089809;19410;19418.70871936922;19457.416277511697;19461.318853840046;7078.539894906815;7115.644217789089;7306.378957788647;7342.632868356561;7499.400047996147;993.9403635781877;1006.4816619440994;1034.9896501035043;1104.376027544435;1141.383652827464;34437.65562344395;34738.82630586831;34823.825880870434;34986;35369.57238979843;1071.276888100529;1096.6545538155456;1140.3386036099043;1171.7930531552515;1174.1135442740676;16519.752203716955;17087.32824579882;17269.913650431918;17297.56756081108;17314.91342543279;532382;533631;536365;536938;537307;60595;60986.390136098074;61059.08411373833;61102.38897611056;61232.38767612267;1329.6343505536056;1370.4792178971927;1390.5689236336768;1391.4573316406609;1403.305363844883;30252.84873575618;31768.841155795;32807.507887382184;32923;33384.83307583447;51979.74010129925;52591.47408526019;52873.471265286855;52963;53014.46985530095;480397;483377;483895;484667;484868;29086.418271634873;29112.854435727684;29172.416551669274;29340;29539;48238.27642585434;48722.75638621926;49123;49315.753421232665;49671.751641241564;40547.56075715143;42577.05881764864;43553.78223108864;43607;43953;41916;42699.92003198745;43065;43197.136057279306;43430.78284608557;42465.575344246165;42700.572994269656;44190.11619767523;44418.11163776771;46422.30366544572;34878.476822848184;38880.80559597184;39548;39752;39794.60205397909;29655;29979.250518737204;30276.24309392283;30371.544426833174;30560.694393056674 16:24:52 INFO - PROCESS | 30028 | |2;jquery.html;393.6437524040744;396.66085496900166;408.5812042656277;412.12423599850314;422.8731380585825;13867.722645547083;18380.264789408426;19198.90400547995;20318.796812031876;20390.69413958792;13626;13771.380287887045;13790.379432925518;18350;18742;5312.442193569677;5434.7826086956475;5458.4541545845495;5465.562754979612;5514.476124768141;5637.238972738669;5704.3154821421485;5742;5747.42525747424;5792.623479473842;5173.767180476888;5425.782968681248;5772.249607551013;5787.04513755232;5808.390119037483;5169.250458683488;5184.844454666366;5199.714015729133;5231.084560201987;5245.973770131144;4929.507049295078;5089.694618322913;5097.337346144977;5109.437961824234;5117.283580298761;13980.58058258254;14066.2966851657;14161.29193540319;14176.574702758933;21675.45811354713;2361.4787496654194;2362.7400985891536;2465.174166654173;2466.987665061681;2988.6861879502776;9871.160951319147;10438.478076096164;10499;14870.628234294229;15226.847731522765;1919.673655478572;1951.180623720093;1956.2957335359258;1994.4216177308563;2002.1590931808676;81819;85919;86924.13075869223;87940;88663;11038.558457661764;11052.944735276273;11244.044256238149;11456.198066135457;11550.422478876022;15930.283137258852;15948;16060.678786424207;16075.82976298208;16102.75845862313;8054.838903221903;8263.834723305621;8337.95831020841;8413.013380250046;8735.301175905912;8212.384071194685;8239;8242;8511.957440212884;8549.145085491402;4743.620510359163;4745.6440766942615;4824.131656301829;4893.755312234374;4894.119058569491;1959.5590992026964;1990.6715391960165;2008.7545721652668;2078.490769761418;2089.6552068908763;1022.5334232554461;1037.3153718545875;1041.2607048995146;1048.1771809129796;1104.8508451359126;20206.29277975264;20288.289909853083;20354;20415;20873.973273875203;1011.8836333821705;1022.3559157730582;1029.6602121299952;1041.6822869024868;1060.5598676549146;10724.356538607708;11408.25846320003;11521.596744113916;11565.537378504765;11576.594819181288;485356;487536;488346;490333;510521;60635;73925.63037184888;94412.52793735988;95779;97023;973.3478569358547;1007.1439276614965;1022.3610243597751;1042.08296698906;1053.1101219469535;17087.914560427118;17329.653406932044;18086.457406277834;18182.81817181811;18525.722114168027;42112.789436052626;43044.56955430406;43179.13641727211;43613;44077.11845763131;60065;60166.39833601608;60336;60467;60964.39035609587;7530.510516816389;7769.223077692185;7876.960615196887;8175.550344731097;8241.752747417588;7887.84224315522;11781.76436471283;11865.813418658065;12908.935455323039;13335;11822.645320640395;11892.702682433008;12134.696632583902;12196.75606487883;12512.810258204596;6204.813855584159;7740.26467485588;11874.228175168586;11903.46434410471;11994.100442466675;6460.741570337322;8802.031776504708;10988.120950323795;11546.711332216762;11772.411379430823;8822.161894620001;8876.955615221883;9007.144321289466;9224.215941644767;9233.676821311223;8798.780030499289;12156.270623762603;12488.25070495773;12535.686607834878;12587 16:24:52 INFO - PROCESS | 30028 | |3;mootools.html;1493.7087267982745;1503.6842263124743;1664.4840099569135;1710.5210541048511;1787.0439314966488;7459.104907411104;8094.23104805044;8208.75373738788;8928.687495937635;8933.463992160476;8165.959170204141;8282.461639993397;8489.448185867914;8548.70079547216;8589.742307730778;2297.7472478027403;2357.1396440299254;2357.4106473381653;2359.5988681924027;2363.0665886974634;2230.9219177328796;2300.1719381022817;2328.382978510696;2328.8020518255967;2329.9767002330013;2277.954440911181;2291.278247352079;2292.816574674022;2295.1393227539675;2304.7349554801162;2226.053927080984;2227.3429338345145;2233.798958093771;2235.552889422114;2287.3824067501846;2259.7401298850677;2284.9543009139725;2289.828262880291;2292.7592602776804;2296.8621882686925;8568.871466928002;8658.134186581354;8664.696735614287;8672.653093876237;8682.218600326001;4945.23348880924;4983.202687569971;4989.301497790312;4996.850094497171;5018.473060328686;3157.226479512511;3252.560904277916;3398.677125673057;3406.5741782277214;3414.402479566066;1191.5531675621642;1202.1464760020397;1229.5327775445362;1245.9626211213679;1247.681841130506;11680.123990700646;11842.052635789203;11907.702307442383;11956.043516518657;11985.64043078709;4292.720973136736;4425.159219748238;4523.208438523246;4569.405977223007;4576.542345765397;10111.241656875764;10156.746081348025;10168.33905796121;10207.438590877573;10256.948715256376;5106.157484015096;5117.513836185556;5190.480951904855;5193.324867767166;5206.97396513015;4087.550369459357;4598.494165641777;4668.719876807402;4716.174669432836;4776.522347765195;3674.669279764834;3708.1100535871196;3781.6785573226034;3793.5827059023486;3812.4471951566866;1147.0995268714018;1158.3976332307152;1169.7536548579615;1178.2871362825538;1209.9395030248452;854.2994744309607;993.1707024634367;1005.4872015272264;1013.8124446977333;1032.550840384435;5692.260006199251;5868.735906884201;5872.207252021008;5880.764769409261;6087.147799308101;425.1560652105568;425.179403750764;435.86270324848203;443.312865059157;444.37787098062324;4128.236276288896;4137.648299894482;4157.625813676784;4164.5210800757695;4204.684648651363;10428.217883658755;10529.262951593468;10554.736131596772;10661.466926653637;10666.093382062456;10508.789824203473;10514.894851051391;10540.367577945195;10548.261621686563;10602.416867072385;7469.962650186714;7776.92223077762;7828.569428681477;7904.367650587939;7928.088269848926;5983.763749639892;6042.8791424170395;6086.573939824169;6155.569110162425;6187.84530386744;9935.552900119657;10041.347312424668;10050.346727462691;10066.798664026532;10210.540525676213;9426.387284826464;9705.951470242604;9797.06927841854;9974.750631233986;10146.137578305632;6584.604923704593;7416.147143078615;7559;7602.315791578784;7798.844023119619;8319.251267385964;8417.537035463109;8455.915440845512;8489;8500.70247541333;7461;7477.177510473953;7484.887726683995;7596.772096837104;7764.6894124234395;7222.494425390172;7496.812579685551;7517.323440890346;7678;7704.19105993885;6520.445762110274;6642.3025582315095;6669.499787515859;6679.131712877295;6688.899666504909;4916.459189489082;5147.845564633067;5159.871003224949;5167.069927413102;5202.297689811827;5127.102757017582;5137.948620513747;5154.922676159786;5195.376554813295;5208.322918020633 16:24:52 INFO - PROCESS | 30028 | |4;prototype.html;320.82194382117916;334.0329745387104;337.57128446872474;341.6958906573152;342.3478273888242;5374.274472946151;5400.8658181781775;5529.889402211958;5590.916136257954;5621.915671264924;5428.67427954322;5493.121100623901;5505.284313039299;5516.6072865187925;5525.475079867416;4265.78671066447;4269.978650106761;4280.850170244042;4284.250256205151;4294.441722576061;4147.502299724038;4230.196262710076;4242.321228603424;4287.764172970486;4318.460192475941;4216.388623649569;4217.7891105444605;4222.345536441856;4233.1956928183545;4234.809433575481;4208.957910420887;4215.49414070312;4218.535961044298;4235.830566777326;4259.339802330644;3673.1918977824835;3736.23407201523;3747.063234191452;3754.3617585010616;3757.5678796938428;5358.427954581823;5365.275687782138;5370.650907690988;5399.730013499309;5405.162199858989;4926.201936293263;4931.975340123312;4939.333190019337;4941.579965702919;4970.801167953314;5552.333719953632;5748.396418376052;5769.567282453832;5817.574694199906;5839.656878917873;4077.4495443115097;4109.671226301889;4110.46563946688;4115.54728979812;4129.442525259082;5980.43185897339;6000.459958603703;6071.210742603477;6079.908801367983;6109.725062372159;4064.7154699170774;4217.451731274915;4263.339182426729;4274.786260686953;4285.528591854893;4266.8293268269545;4268.40242366069;4282.700210985201;4286.507051689034;4325.610695037399;4886.071646387246;4920.926186107211;4937.5556199942175;4937.7531123444405;4971.6022718183185;5667.744951477111;5842.620229685057;5901.704914754245;5909.734061967221;5925.911111333247;1422.879055280292;1471.4114354258381;1472.3815997280954;1479.6818683982995;1483.859033391826;905.8550631898864;935.1677007463363;939.4738946190155;950.064186776025;953.1516949914582;4784.545468180518;4787.779116325384;4813.975930120327;4835.274708793709;4917.246342048465;5219.9903037330905;5221.295125158055;5224.608154388436;5281.762320695578;5338.626296159232;4757.881052973703;4913.336699545587;4941.431735350408;4947.554720075211;4955.603551715854;2741.424300896834;2752.573351130538;2754.793390495721;2762.267998980272;2778.5554311310093;5338.903436007106;5341.919871201935;5352.9732351338;5353.86615334612;5356.678599284055;4947.950520494821;5203.947960520346;5241.633085684041;5264.973675131677;5292.603054770908;5343.812966546152;5354.464553544614;5384.6769193848495;5385.892282154335;5393.946060539502;5197;5214.634975551675;5220.843374698765;5237.423883372902;5280.81517146898;5205.843824685266;5513.669179849222;5907.734151963086;5946.613470124428;5953.523718102455;6240;6248.4064013918605;6268.937310627018;6275.592086514362;6305.675808080355;3978.8607398740905;4231.936520952249;4240.554741752195;4243.89658688737;4263.936040959326;5790.276215473066;5877.265341832271;5899.528037757055;5903.822885313448;5998.920194364881;5824.776796872535;5825.446582574648;5844.853878653068;5866.941330586639;5886.6173698709445;5830.2129212555765;5845.444682755132;5860.179574859438;5869.8239052826775;5898.4101589840675;5601.663900166003;5780.971095144666;5800.100984347433;5812.883742325214;5832.912506312324;5869.7945571904775;5892.646441213541;5897.823065308047;5922.170896074467;5929.822105336847;5630.5777066720975;5709.942900570941;5715.480796522364;5755.827325180251;5766.538676905753 16:24:52 INFO - PROCESS | 30028 | |5;yui.html;760.3043215457853;773.1920143450094;799.3125911715923;839.6364234679373;884.641720103358;14220.28898555072;14618.634534136625;14682.999999999987;14705.264736763173;14728.6317842054;14239.501617443366;14351.497697580588;14405.567832965002;14422.134671919666;14442.422303107864;815.8694608862584;819.0703551469096;824.8102936324649;825.5170725125809;825.5789547330844;796.7808852565532;821.256762629818;822.995885020577;823.9423240373176;827.1976183102411;852.4203541591716;855.1747563601124;855.4696088425154;856.3919617071887;858.2790456016944;841.8484672758901;849.9957500212521;851.4380508864182;852.0669866496177;853.1724227499316;626.3798839149255;626.677261210477;628.6102616377875;630.2279707358495;630.5586089737202;15046.849531504655;15094.924525377413;15101.942863999524;15105.848941510554;15113;14687.55937321882;14746.557603271918;14795.630109247248;14956.40174393023;15090.849091509053;12518.436670349765;12570.37516815302;12623.368831558386;12862.292573908431;13549.254790986492;3863.208042351311;3920.372740361557;3921.88234352967;3958.841646334143;3995.760254384746;88818;89174.5541272296;89254.5537272316;90073;90595.54702226447;10928.722477920139;11010.284331518425;11406.942965285121;11571.132165087653;11701.122415818678;21599;21686.156676682658;21753.564928701653;22022.559548809255;22026.88986555057;8206.138355472589;8494.320454363637;8497.065322814486;8498.787530311669;8610.268127209132;5012.573931215815;5016.046951079284;5107.821226257138;5173;5246;3428.177237462991;3531.081918701156;3539.380608393521;3545.62770909056;3555.0579096539436;622.343427683789;630.8675178212627;631.6589041917313;632.908228306893;633.6166619195412;747.9513831600929;748.5037400270052;786.5752493653363;787.7321710618418;806.2662976691183;8806.25146862511;10085.294029418017;10126.493675316206;10348.327358721659;10353.844692329621;672.7914346552584;730.8486459988982;741.5439504704676;748.8988986486863;757.8560073586001;5017.996191387724;5019.272205530177;5030.320906677625;5044.0920634286185;5097.694138351637;127870;128346;129160.35419823028;129403.35298323448;130299.34850325878;111781;111926;114841;115256.42371788256;115988;78476.21523784804;81364.3727125466;97737;97767.51116244373;100365.49817250867;9980.750481237737;10209.030142136486;10214.438205898747;10334.431606261727;10350.948245258725;50838.491615083374;52212.738936305075;52631.78850135299;53600.46399535955;53862.96027797853;72317;80937.19062809533;82052.58973705093;82291;82643;12891.484340626645;13186.208827470382;13280.867191327963;13895.58313250604;14178.36044106467;13331.600051998455;14692.338844752225;14701.41194352214;14831.777523337374;15074.397024118913;14309.856901430852;14476.782848257073;14566.41734330615;14684.85315146835;14741.894357922984;13275.80086298687;13619.114757540729;13699.794503082661;13710.245936473191;13973.231472269123;12903.385910403862;14013.859861401255;14135.858641413453;14177.858221417653;14495.637609059859;10249.472049844342;10677.679669609613;10806.513706883052;11631.709207269885;11731.824022639837;11891.405429728651;12357.691057723629;12376;12474.875251247371;12707.618771436872 16:24:52 INFO - PROCESS | 30028 | __end_tp_report 16:24:52 INFO - PROCESS | 30028 | __start_cc_report 16:24:52 INFO - PROCESS | 30028 | _x_x_mozilla_cycle_collect,323 16:24:52 INFO - PROCESS | 30028 | __end_cc_report 16:24:52 INFO - PROCESS | 30028 | __startTimestamp1471476292120__endTimestamp 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - PROCESS | 30028 | ------- Summary: start ------- 16:24:52 INFO - PROCESS | 30028 | Number of tests: 6 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - PROCESS | 30028 | [#0] dojo.html Cycles:165 Average:5230.65 Median:5441.35 stddev:697.88 (12.8%) stddev-sans-first:678.30 16:24:52 INFO - PROCESS | 30028 | Values: 3028.2 3049.2 3060.4 3066.3 3086.8 5218.3 5318.3 5411.2 5432.1 5441.0 5261.4 5343.7 5356.6 5357.6 5366.3 4790.9 4795.6 4826.2 4849.2 4871.5 4720.7 4737.2 4745.8 4749.3 4765.0 706.2 4797.0 4809.8 4817.3 4870.1 4702.8 4759.3 4776.8 4789.7 4793.8 4692.9 4697.1 4715.6 4719.2 4743.0 5149.2 5202.1 5230.3 5235.8 5300.2 5576.6 5605.6 5622.4 5686.8 5714.5 5692.4 5702.3 5709.9 5725.3 5734.2 5128.4 5327.2 5335.6 5348.8 5393.8 5674.5 5702.4 5732.4 5766.1 5821.2 5513.7 5529.7 5551.1 5559.1 5574.5 5523.3 5619.3 5622.5 5627.2 5643.6 5573.2 5596.6 5660.7 5763.0 5798.3 5643.6 5706.8 5711.4 5714.1 5714.8 4246.0 4430.0 4435.9 4438.4 4475.9 3794.9 3849.0 3852.2 3859.8 3886.3 5225.8 5274.6 5287.7 5297.3 5300.4 5469.6 5598.0 5619.8 5637.2 5657.7 5317.2 5347.2 5381.2 5428.5 5435.3 4883.5 4901.3 4920.1 4922.3 4958.2 5774.6 5863.4 5876.4 5894.1 5919.5 5675.3 5752.8 5772.5 5810.3 5815.0 5926.6 5952.9 5953.7 5955.0 5961.9 5457.1 5493.7 5547.2 5608.9 5613.1 5693.5 5717.5 5721.9 5759.2 5763.0 5523.6 5559.7 5563.2 5573.6 5589.6 5375.4 5375.4 5509.3 5518.8 5532.8 5396.1 5440.2 5442.0 5463.6 5520.8 5441.3 5472.5 5498.2 5522.5 5528.8 5310.3 5404.1 5405.4 5421.3 5455.1 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - PROCESS | 30028 | [#1] ext.html Cycles:180 Average:59734.68 Median:42458.58 stddev:120173.95 (283.0%) stddev-sans-first:120428.99 16:24:52 INFO - PROCESS | 30028 | Values: 576.5 576.9 588.6 592.0 623.0 40218.0 45260.3 45313.8 45317.5 45434.0 44683.8 45118.5 45190.8 45290.3 45365.0 8861.0 9005.3 9045.2 9101.5 9119.7 8960.5 9014.3 9081.1 9097.3 9100.3 9144.5 9174.9 9181.6 9193.7 9206.3 9057.5 9088.5 9152.3 9166.0 9173.4 8979.0 9009.5 9042.5 9048.3 9055.3 42451.6 42933.6 42934.1 42937.4 43022.0 2599.8 3229.6 3314.7 3454.5 3555.3 29206.9 29663.7 31425.4 31934.5 32042.0 4076.1 4197.5 4214.8 4270.9 4317.1 304705.0 306386.0 307036.0 307644.0 307703.0 35162.3 35495.5 35509.3 35528.3 35751.3 36937.3 37038.6 37073.1 37296.5 37446.4 17216.5 17433.4 17439.6 17644.2 17669.2 13283.0 13394.7 13402.6 13432.1 13433.4 19311.2 19410.0 19418.7 19457.4 19461.3 7078.5 7115.6 7306.4 7342.6 7499.4 993.9 1006.5 1035.0 1104.4 1141.4 34437.7 34738.8 34823.8 34986.0 35369.6 1071.3 1096.7 1140.3 1171.8 1174.1 16519.8 17087.3 17269.9 17297.6 17314.9 532382.0 533631.0 536365.0 536938.0 537307.0 60595.0 60986.4 61059.1 61102.4 61232.4 1329.6 1370.5 1390.6 1391.5 1403.3 30252.8 31768.8 32807.5 32923.0 33384.8 51979.7 52591.5 52873.5 52963.0 53014.5 480397.0 483377.0 483895.0 484667.0 484868.0 29086.4 29112.9 29172.4 29340.0 29539.0 48238.3 48722.8 49123.0 49315.8 49671.8 40547.6 42577.1 43553.8 43607.0 43953.0 41916.0 42699.9 43065.0 43197.1 43430.8 42465.6 42700.6 44190.1 44418.1 46422.3 34878.5 38880.8 39548.0 39752.0 39794.6 29655.0 29979.3 30276.2 30371.5 30560.7 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - PROCESS | 30028 | [#2] jquery.html Cycles:180 Average:28783.75 Median:2727.84 stddev:81257.18 (2978.8%) stddev-sans-first:81457.16 16:24:52 INFO - PROCESS | 30028 | Values: 393.6 396.7 408.6 412.1 422.9 13867.7 18380.3 19198.9 20318.8 20390.7 13626.0 13771.4 13790.4 18350.0 18742.0 5312.4 5434.8 5458.5 5465.6 5514.5 5637.2 5704.3 5742.0 5747.4 5792.6 5173.8 5425.8 5772.2 5787.0 5808.4 5169.3 5184.8 5199.7 5231.1 5246.0 4929.5 5089.7 5097.3 5109.4 5117.3 13980.6 14066.3 14161.3 14176.6 21675.5 2361.5 2362.7 2465.2 2467.0 2988.7 9871.2 10438.5 10499.0 14870.6 15226.8 1919.7 1951.2 1956.3 1994.4 2002.2 81819.0 85919.0 86924.1 87940.0 88663.0 11038.6 11052.9 11244.0 11456.2 11550.4 15930.3 15948.0 16060.7 16075.8 16102.8 8054.8 8263.8 8338.0 8413.0 8735.3 8212.4 8239.0 8242.0 8512.0 8549.1 4743.6 4745.6 4824.1 4893.8 4894.1 1959.6 1990.7 2008.8 2078.5 2089.7 1022.5 1037.3 1041.3 1048.2 1104.9 20206.3 20288.3 20354.0 20415.0 20874.0 1011.9 1022.4 1029.7 1041.7 1060.6 10724.4 11408.3 11521.6 11565.5 11576.6 485356.0 487536.0 488346.0 490333.0 510521.0 60635.0 73925.6 94412.5 95779.0 97023.0 973.3 1007.1 1022.4 1042.1 1053.1 17087.9 17329.7 18086.5 18182.8 18525.7 42112.8 43044.6 43179.1 43613.0 44077.1 60065.0 60166.4 60336.0 60467.0 60964.4 7530.5 7769.2 7877.0 8175.6 8241.8 7887.8 11781.8 11865.8 12908.9 13335.0 11822.6 11892.7 12134.7 12196.8 12512.8 6204.8 7740.3 11874.2 11903.5 11994.1 6460.7 8802.0 10988.1 11546.7 11772.4 8822.2 8877.0 9007.1 9224.2 9233.7 8798.8 12156.3 12488.3 12535.7 12587.0 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - PROCESS | 30028 | [#3] mootools.html Cycles:180 Average:5648.86 Median:2483.79 stddev:3208.63 (129.2%) stddev-sans-first:3202.44 16:24:52 INFO - PROCESS | 30028 | Values: 1493.7 1503.7 1664.5 1710.5 1787.0 7459.1 8094.2 8208.8 8928.7 8933.5 8166.0 8282.5 8489.4 8548.7 8589.7 2297.7 2357.1 2357.4 2359.6 2363.1 2230.9 2300.2 2328.4 2328.8 2330.0 2278.0 2291.3 2292.8 2295.1 2304.7 2226.1 2227.3 2233.8 2235.6 2287.4 2259.7 2285.0 2289.8 2292.8 2296.9 8568.9 8658.1 8664.7 8672.7 8682.2 4945.2 4983.2 4989.3 4996.9 5018.5 3157.2 3252.6 3398.7 3406.6 3414.4 1191.6 1202.1 1229.5 1246.0 1247.7 11680.1 11842.1 11907.7 11956.0 11985.6 4292.7 4425.2 4523.2 4569.4 4576.5 10111.2 10156.7 10168.3 10207.4 10256.9 5106.2 5117.5 5190.5 5193.3 5207.0 4087.6 4598.5 4668.7 4716.2 4776.5 3674.7 3708.1 3781.7 3793.6 3812.4 1147.1 1158.4 1169.8 1178.3 1209.9 854.3 993.2 1005.5 1013.8 1032.6 5692.3 5868.7 5872.2 5880.8 6087.1 425.2 425.2 435.9 443.3 444.4 4128.2 4137.6 4157.6 4164.5 4204.7 10428.2 10529.3 10554.7 10661.5 10666.1 10508.8 10514.9 10540.4 10548.3 10602.4 7470.0 7776.9 7828.6 7904.4 7928.1 5983.8 6042.9 6086.6 6155.6 6187.8 9935.6 10041.3 10050.3 10066.8 10210.5 9426.4 9706.0 9797.1 9974.8 10146.1 6584.6 7416.1 7559.0 7602.3 7798.8 8319.3 8417.5 8455.9 8489.0 8500.7 7461.0 7477.2 7484.9 7596.8 7764.7 7222.5 7496.8 7517.3 7678.0 7704.2 6520.4 6642.3 6669.5 6679.1 6688.9 4916.5 5147.8 5159.9 5167.1 5202.3 5127.1 5137.9 5154.9 5195.4 5208.3 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - PROCESS | 30028 | [#4] prototype.html Cycles:180 Average:4722.19 Median:5253.30 stddev:1392.46 (26.5%) stddev-sans-first:1356.61 16:24:52 INFO - PROCESS | 30028 | Values: 320.8 334.0 337.6 341.7 342.3 5374.3 5400.9 5529.9 5590.9 5621.9 5428.7 5493.1 5505.3 5516.6 5525.5 4265.8 4270.0 4280.9 4284.3 4294.4 4147.5 4230.2 4242.3 4287.8 4318.5 4216.4 4217.8 4222.3 4233.2 4234.8 4209.0 4215.5 4218.5 4235.8 4259.3 3673.2 3736.2 3747.1 3754.4 3757.6 5358.4 5365.3 5370.7 5399.7 5405.2 4926.2 4932.0 4939.3 4941.6 4970.8 5552.3 5748.4 5769.6 5817.6 5839.7 4077.4 4109.7 4110.5 4115.5 4129.4 5980.4 6000.5 6071.2 6079.9 6109.7 4064.7 4217.5 4263.3 4274.8 4285.5 4266.8 4268.4 4282.7 4286.5 4325.6 4886.1 4920.9 4937.6 4937.8 4971.6 5667.7 5842.6 5901.7 5909.7 5925.9 1422.9 1471.4 1472.4 1479.7 1483.9 905.9 935.2 939.5 950.1 953.2 4784.5 4787.8 4814.0 4835.3 4917.2 5220.0 5221.3 5224.6 5281.8 5338.6 4757.9 4913.3 4941.4 4947.6 4955.6 2741.4 2752.6 2754.8 2762.3 2778.6 5338.9 5341.9 5353.0 5353.9 5356.7 4948.0 5203.9 5241.6 5265.0 5292.6 5343.8 5354.5 5384.7 5385.9 5393.9 5197.0 5214.6 5220.8 5237.4 5280.8 5205.8 5513.7 5907.7 5946.6 5953.5 6240.0 6248.4 6268.9 6275.6 6305.7 3978.9 4231.9 4240.6 4243.9 4263.9 5790.3 5877.3 5899.5 5903.8 5998.9 5824.8 5825.4 5844.9 5866.9 5886.6 5830.2 5845.4 5860.2 5869.8 5898.4 5601.7 5781.0 5800.1 5812.9 5832.9 5869.8 5892.6 5897.8 5922.2 5929.8 5630.6 5709.9 5715.5 5755.8 5766.5 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - PROCESS | 30028 | [#5] yui.html Cycles:180 Average:22443.19 Median:3535.23 stddev:33581.73 (949.9%) stddev-sans-first:33636.47 16:24:52 INFO - PROCESS | 30028 | Values: 760.3 773.2 799.3 839.6 884.6 14220.3 14618.6 14683.0 14705.3 14728.6 14239.5 14351.5 14405.6 14422.1 14442.4 815.9 819.1 824.8 825.5 825.6 796.8 821.3 823.0 823.9 827.2 852.4 855.2 855.5 856.4 858.3 841.8 850.0 851.4 852.1 853.2 626.4 626.7 628.6 630.2 630.6 15046.8 15094.9 15101.9 15105.8 15113.0 14687.6 14746.6 14795.6 14956.4 15090.8 12518.4 12570.4 12623.4 12862.3 13549.3 3863.2 3920.4 3921.9 3958.8 3995.8 88818.0 89174.6 89254.6 90073.0 90595.5 10928.7 11010.3 11406.9 11571.1 11701.1 21599.0 21686.2 21753.6 22022.6 22026.9 8206.1 8494.3 8497.1 8498.8 8610.3 5012.6 5016.0 5107.8 5173.0 5246.0 3428.2 3531.1 3539.4 3545.6 3555.1 622.3 630.9 631.7 632.9 633.6 748.0 748.5 786.6 787.7 806.3 8806.3 10085.3 10126.5 10348.3 10353.8 672.8 730.8 741.5 748.9 757.9 5018.0 5019.3 5030.3 5044.1 5097.7 127870.0 128346.0 129160.4 129403.4 130299.3 111781.0 111926.0 114841.0 115256.4 115988.0 78476.2 81364.4 97737.0 97767.5 100365.5 9980.8 10209.0 10214.4 10334.4 10350.9 50838.5 52212.7 52631.8 53600.5 53863.0 72317.0 80937.2 82052.6 82291.0 82643.0 12891.5 13186.2 13280.9 13895.6 14178.4 13331.6 14692.3 14701.4 14831.8 15074.4 14309.9 14476.8 14566.4 14684.9 14741.9 13275.8 13619.1 13699.8 13710.2 13973.2 12903.4 14013.9 14135.9 14177.9 14495.6 10249.5 10677.7 10806.5 11631.7 11731.8 11891.4 12357.7 12376.0 12474.9 12707.6 16:24:52 INFO - PROCESS | 30028 | -------- Summary: end -------- 16:24:52 INFO - PROCESS | 30028 | 16:24:52 INFO - TEST-INFO | 30028: exit 0 16:24:52 INFO - TEST-OK | dromaeo_css | took 1112865ms 16:24:52 INFO - TEST-START | kraken 16:24:52 INFO - operating with platform_type : linux_ 16:24:52 INFO - Initialising browser for kraken test... 16:24:52 INFO - TEST-INFO | started process 30392 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdiUeL9/profile http://localhost:36990/getInfo.html) 16:24:57 INFO - PROCESS | 30392 | __metrics Screen width/height:1600/1200 16:24:57 INFO - PROCESS | 30392 | colorDepth:24 16:24:57 INFO - PROCESS | 30392 | Browser inner width/height: 1024/697 16:24:57 INFO - PROCESS | 30392 | __metrics 16:24:58 ERROR - PROCESS | 30392 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 16:24:58 INFO - TEST-INFO | 30392: exit 0 16:24:58 INFO - Browser initialized. 16:24:58 INFO - Running cycle 1/1 for kraken test... 16:24:58 INFO - TEST-INFO | started process 30514 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdiUeL9/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:25:10 INFO - PROCESS | 30514 | RSS: Main: 163287040 16:25:10 INFO - PROCESS | 30514 | 16:25:13 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:36990/tests/kraken/driver.html?testName=audio-beat-detection) 16:25:14 INFO - PROCESS | 30514 | RSS: Main: 168132608 16:25:14 INFO - PROCESS | 30514 | 16:25:16 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:36990/tests/kraken/driver.html?testName=audio-dft) 16:25:17 INFO - PROCESS | 30514 | RSS: Main: 167661568 16:25:17 INFO - PROCESS | 30514 | 16:25:20 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:36990/tests/kraken/driver.html?testName=audio-fft) 16:25:20 INFO - PROCESS | 30514 | RSS: Main: 163278848 16:25:20 INFO - PROCESS | 30514 | 16:25:22 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:36990/tests/kraken/driver.html?testName=audio-oscillator) 16:25:23 INFO - PROCESS | 30514 | RSS: Main: 164417536 16:25:23 INFO - PROCESS | 30514 | 16:25:25 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:36990/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:25:26 INFO - PROCESS | 30514 | RSS: Main: 164384768 16:25:26 INFO - PROCESS | 30514 | 16:25:29 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:36990/tests/kraken/driver.html?testName=imaging-darkroom) 16:25:30 INFO - PROCESS | 30514 | RSS: Main: 165273600 16:25:30 INFO - PROCESS | 30514 | 16:25:33 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:36990/tests/kraken/driver.html?testName=imaging-desaturate) 16:25:34 INFO - PROCESS | 30514 | RSS: Main: 162283520 16:25:34 INFO - PROCESS | 30514 | 16:25:37 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:36990/tests/kraken/driver.html?testName=json-parse-financial) 16:25:37 INFO - PROCESS | 30514 | RSS: Main: 163934208 16:25:37 INFO - PROCESS | 30514 | 16:25:39 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:36990/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:25:40 INFO - PROCESS | 30514 | RSS: Main: 164298752 16:25:40 INFO - PROCESS | 30514 | 16:25:41 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:36990/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:25:42 INFO - PROCESS | 30514 | RSS: Main: 164159488 16:25:42 INFO - PROCESS | 30514 | 16:25:44 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:36990/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:25:45 INFO - PROCESS | 30514 | RSS: Main: 164564992 16:25:45 INFO - PROCESS | 30514 | 16:25:47 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:36990/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:25:48 INFO - PROCESS | 30514 | RSS: Main: 165068800 16:25:48 INFO - PROCESS | 30514 | 16:25:51 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:36990/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:25:51 INFO - PROCESS | 30514 | RSS: Main: 165269504 16:25:51 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | Cycle 1(1): loaded http://localhost:36990/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:36990/tests/kraken/driver.html?testName=ai-astar) 16:25:53 INFO - PROCESS | 30514 | RSS: Main: 165994496 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | __start_tp_report 16:25:53 INFO - PROCESS | 30514 | _x_x_mozilla_page_load 16:25:53 INFO - PROCESS | 30514 | _x_x_mozilla_page_load_details 16:25:53 INFO - PROCESS | 30514 | |i|pagename|runs| 16:25:53 INFO - PROCESS | 30514 | |0;ai-astar;105;111;111;111;113;112;118;112;112;115 16:25:53 INFO - PROCESS | 30514 | |1;audio-beat-detection;153;124;151;183;123;148;158;122;178;120 16:25:53 INFO - PROCESS | 30514 | |2;audio-dft;162;162;163;164;162;165;169;163;163;162 16:25:53 INFO - PROCESS | 30514 | |3;audio-fft;75;75;76;187;76;75;76;75;164;77 16:25:53 INFO - PROCESS | 30514 | |4;audio-oscillator;86;85;142;86;87;85;140;85;85;149 16:25:53 INFO - PROCESS | 30514 | |5;imaging-gaussian-blur;118;118;118;117;117;117;117;118;118;121 16:25:53 INFO - PROCESS | 30514 | |6;imaging-darkroom;155;148;148;147;147;148;146;147;147;149 16:25:53 INFO - PROCESS | 30514 | |7;imaging-desaturate;98;96;96;100;96;96;96;95;96;96 16:25:53 INFO - PROCESS | 30514 | |8;json-parse-financial;52;52;59;54;56;57;53;54;54;56 16:25:53 INFO - PROCESS | 30514 | |9;json-stringify-tinderbox;62;62;62;62;62;62;63;62;62;63 16:25:53 INFO - PROCESS | 30514 | |10;stanford-crypto-aes;95;85;83;80;80;78;82;79;78;82 16:25:53 INFO - PROCESS | 30514 | |11;stanford-crypto-ccm;140;126;125;126;125;131;144;136;186;137 16:25:53 INFO - PROCESS | 30514 | |12;stanford-crypto-pbkdf2;172;165;169;170;179;165;168;169;167;176 16:25:53 INFO - PROCESS | 30514 | |13;stanford-crypto-sha256-iterative;76;66;66;67;68;68;65;65;63;65 16:25:53 INFO - PROCESS | 30514 | __end_tp_report 16:25:53 INFO - PROCESS | 30514 | __start_cc_report 16:25:53 INFO - PROCESS | 30514 | _x_x_mozilla_cycle_collect,880 16:25:53 INFO - PROCESS | 30514 | __end_cc_report 16:25:53 INFO - PROCESS | 30514 | __startTimestamp1471476353964__endTimestamp 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | ------- Summary: start ------- 16:25:53 INFO - PROCESS | 30514 | Number of tests: 14 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#0] ai-astar Cycles:10 Average:112.00 Median:112.00 stddev:3.30 (2.9%) stddev-sans-first:2.33 16:25:53 INFO - PROCESS | 30514 | Values: 105.0 111.0 111.0 111.0 113.0 112.0 118.0 112.0 112.0 115.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#1] audio-beat-detection Cycles:10 Average:146.00 Median:152.00 stddev:23.29 (15.3%) stddev-sans-first:24.56 16:25:53 INFO - PROCESS | 30514 | Values: 153.0 124.0 151.0 183.0 123.0 148.0 158.0 122.0 178.0 120.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#2] audio-dft Cycles:10 Average:163.50 Median:163.00 stddev:2.17 (1.3%) stddev-sans-first:2.24 16:25:53 INFO - PROCESS | 30514 | Values: 162.0 162.0 163.0 164.0 162.0 165.0 169.0 163.0 163.0 162.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#3] audio-fft Cycles:10 Average:95.60 Median:75.50 stddev:42.46 (56.2%) stddev-sans-first:44.38 16:25:53 INFO - PROCESS | 30514 | Values: 75.0 75.0 76.0 187.0 76.0 75.0 76.0 75.0 164.0 77.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#4] audio-oscillator Cycles:10 Average:103.00 Median:85.00 stddev:28.16 (33.1%) stddev-sans-first:29.19 16:25:53 INFO - PROCESS | 30514 | Values: 86.0 85.0 142.0 86.0 87.0 85.0 140.0 85.0 85.0 149.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#5] imaging-gaussian-blur Cycles:10 Average:117.90 Median:118.00 stddev:1.20 (1.0%) stddev-sans-first:1.27 16:25:53 INFO - PROCESS | 30514 | Values: 118.0 118.0 118.0 117.0 117.0 117.0 117.0 118.0 118.0 121.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#6] imaging-darkroom Cycles:10 Average:148.20 Median:148.00 stddev:2.53 (1.7%) stddev-sans-first:0.88 16:25:53 INFO - PROCESS | 30514 | Values: 155.0 148.0 148.0 147.0 147.0 148.0 146.0 147.0 147.0 149.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#7] imaging-desaturate Cycles:10 Average:96.50 Median:96.00 stddev:1.43 (1.5%) stddev-sans-first:1.41 16:25:53 INFO - PROCESS | 30514 | Values: 98.0 96.0 96.0 100.0 96.0 96.0 96.0 95.0 96.0 96.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#8] json-parse-financial Cycles:10 Average:54.70 Median:55.00 stddev:2.26 (4.1%) stddev-sans-first:2.18 16:25:53 INFO - PROCESS | 30514 | Values: 52.0 52.0 59.0 54.0 56.0 57.0 53.0 54.0 54.0 56.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#9] json-stringify-tinderbox Cycles:10 Average:62.20 Median:62.00 stddev:0.42 (0.7%) stddev-sans-first:0.44 16:25:53 INFO - PROCESS | 30514 | Values: 62.0 62.0 62.0 62.0 62.0 62.0 63.0 62.0 62.0 63.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#10] stanford-crypto-aes Cycles:10 Average:82.20 Median:82.00 stddev:5.03 (6.1%) stddev-sans-first:2.39 16:25:53 INFO - PROCESS | 30514 | Values: 95.0 85.0 83.0 80.0 80.0 78.0 82.0 79.0 78.0 82.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#11] stanford-crypto-ccm Cycles:10 Average:137.60 Median:136.50 stddev:18.33 (13.4%) stddev-sans-first:19.42 16:25:53 INFO - PROCESS | 30514 | Values: 140.0 126.0 125.0 126.0 125.0 131.0 144.0 136.0 186.0 137.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:170.00 Median:169.50 stddev:4.55 (2.7%) stddev-sans-first:4.76 16:25:53 INFO - PROCESS | 30514 | Values: 172.0 165.0 169.0 170.0 179.0 165.0 168.0 169.0 167.0 176.0 16:25:53 INFO - PROCESS | 30514 | 16:25:53 INFO - PROCESS | 30514 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.90 Median:66.50 stddev:3.54 (5.3%) stddev-sans-first:1.62 16:25:53 INFO - PROCESS | 30514 | Values: 76.0 66.0 66.0 67.0 68.0 68.0 65.0 65.0 63.0 65.0 16:25:53 INFO - PROCESS | 30514 | -------- Summary: end -------- 16:25:53 INFO - PROCESS | 30514 | 16:25:54 INFO - TEST-INFO | 30514: exit 0 16:25:54 INFO - TEST-OK | kraken | took 62160ms 16:25:54 INFO - SUITE-END | took 1175s 16:25:55 INFO - Completed test suite (00:19:35) 16:25:55 INFO - javascript benchmark 16:25:55 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7210.433596671343, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3028.2126647071764, 3049.237690577356, 3060.3879224155176, 3066.294752206992, 3086.8302243376606, 5218.32161818964, 5318.335208098988, 5411.24242606035, 5432.13085906255, 5440.999999999995, 5261.447548007462, 5343.679379237248, 5356.598255130862, 5357.598180136486, 5366.302380690515, 4790.904181916351, 4795.568398844103, 4826.1795494765975, 4849.224124140138, 4871.512848715136, 4720.669553131283, 4737.242041273397, 4745.810167593292, 4749.287606858964, 4765.0, 706.2377228419998, 4796.976015119937, 4809.78355973982, 4817.253325734517, 4870.074685809703, 4702.8118875244945, 4759.262314341283, 4776.80892764289, 4789.688670236458, 4793.808247670124, 4692.859214223578, 4697.060587882403, 4715.622750179978, 4719.244920812688, 4742.976285118552, 5149.201873709581, 5202.06362854686, 5230.267762513251, 5235.816746413857, 5300.178472336794, 5576.581756368248, 5605.607607467479, 5622.409646987089, 5686.800961966353, 5714.45712657301, 5692.402297758758, 5702.344230413472, 5709.857253568694, 5725.341585717654, 5734.197212390269, 5128.435872054071, 5327.227552004976, 5335.599830012726, 5348.759305831208, 5393.7572809223675, 5674.4892959633835, 5702.372738998707, 5732.426757324234, 5766.106253530709, 5821.15593238978, 5513.696746678891, 5529.668219906738, 5551.056320425538, 5559.11054231321, 5574.470425309589, 5523.28197334344, 5619.297587801525, 5622.522085622768, 5627.240322556402, 5643.576731745054, 5573.191887176336, 5596.580256480699, 5660.745266463019, 5763.0202865512965, 5798.275215598051, 5643.5767317451355, 5706.80026199081, 5711.400302968212, 5714.11431228152, 5714.828555143353, 4246.044639955985, 4430.0, 4435.866923992286, 4438.423005009393, 4475.910481790346, 3794.905127371783, 3848.980755096263, 3852.210296889131, 3859.7877116758846, 3886.3198940185353, 5225.790968361299, 5274.604404669665, 5287.682739035593, 5297.337832770903, 5300.363956325188, 5469.644473109235, 5597.972010140004, 5619.80330688424, 5637.182608521742, 5657.688827114548, 5317.175837745156, 5347.1979203119845, 5381.246625472437, 5428.511433970962, 5435.347758269033, 4883.51164883516, 4901.313816065754, 4920.138975679313, 4922.261660750844, 4958.157113290749, 5774.566907481955, 5863.355030946593, 5876.41235876409, 5894.115882617556, 5919.467247947706, 5675.290588676416, 5752.7698892043845, 5772.5381969441505, 5810.302763668386, 5815.011448053757, 5926.644401335933, 5952.851178720393, 5953.672548009901, 5955.0, 5961.8807623846415, 5457.099578569491, 5493.725313734377, 5547.195656629847, 5608.943910560843, 5613.129964855454, 5693.5445164387575, 5717.456841600041, 5721.885562288814, 5759.1649210865025, 5763.049096898964, 5523.558115350682, 5559.749811258584, 5563.248961390161, 5573.637713548606, 5589.552835773047, 5375.354957405137, 5375.381831089475, 5509.256250406304, 5518.806841760519, 5532.778688852401, 5396.109641909198, 5440.183972404171, 5442.047641662773, 5463.644863083887, 5520.779168833202, 5441.347038355423, 5472.507474327171, 5498.1752737089755, 5522.475364840334, 5528.806491772769, 5310.2831117798605, 5404.108322126962, 5405.405405405481, 5421.322334708161, 5455.099908515051], "value": 5185.193682561087, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [576.5301279457242, 576.8557860534867, 588.6115163991766, 591.9999999999999, 622.9813105606834, 40218.0, 45260.32109518356, 45313.77343113288, 45317.546824531826, 45434.0, 44683.77658111705, 45118.54881451184, 45190.77404612972, 45290.320645190346, 45365.0, 8861.0, 9005.279577633806, 9045.185933266037, 9101.499417532033, 9119.726408207764, 8960.462372257685, 9014.323925705565, 9081.091890810932, 9097.317701172406, 9100.317476189279, 9144.451332920013, 9174.908250917471, 9181.58682859273, 9193.678221262257, 9206.309526785484, 9057.50183739894, 9088.50013249271, 9152.313576481723, 9166.0, 9173.40372875761, 8978.955105224497, 9009.549522523914, 9042.502662353569, 9048.321375896834, 9055.275577953747, 42451.57548424538, 42933.57066429327, 42934.06258280307, 42937.35593966093, 43022.0, 2599.8180127391092, 3229.5963004624423, 3314.685104915053, 3454.464557993515, 3555.253396786678, 29206.853965730035, 29663.70336296631, 31425.423796101546, 31934.520982185284, 32042.0, 4076.103257283393, 4197.496300443966, 4214.7681877496725, 4270.871873843789, 4317.050248945227, 304705.0, 306386.0, 307036.0, 307644.0, 307703.0, 35162.29675406529, 35495.4675679865, 35509.28981420357, 35528.289434211685, 35751.28497430037, 36937.261254775294, 37038.629613704055, 37073.10732373116, 37296.50813967411, 37446.43830342547, 17216.483505494856, 17433.389831356097, 17439.604831613695, 17644.206010729293, 17669.20488578017, 13283.0, 13394.665133371549, 13402.597922062354, 13432.126911750705, 13433.39549720265, 19311.22755089809, 19410.0, 19418.70871936922, 19457.416277511697, 19461.318853840046, 7078.539894906815, 7115.644217789089, 7306.378957788647, 7342.632868356561, 7499.400047996147, 993.9403635781877, 1006.4816619440994, 1034.9896501035043, 1104.376027544435, 1141.383652827464, 34437.65562344395, 34738.82630586831, 34823.825880870434, 34986.0, 35369.57238979843, 1071.276888100529, 1096.6545538155456, 1140.3386036099043, 1171.7930531552515, 1174.1135442740676, 16519.752203716955, 17087.32824579882, 17269.913650431918, 17297.56756081108, 17314.91342543279, 532382.0, 533631.0, 536365.0, 536938.0, 537307.0, 60595.0, 60986.390136098074, 61059.08411373833, 61102.38897611056, 61232.38767612267, 1329.6343505536056, 1370.4792178971927, 1390.5689236336768, 1391.4573316406609, 1403.305363844883, 30252.84873575618, 31768.841155795, 32807.507887382184, 32923.0, 33384.83307583447, 51979.74010129925, 52591.47408526019, 52873.471265286855, 52963.0, 53014.46985530095, 480397.0, 483377.0, 483895.0, 484667.0, 484868.0, 29086.418271634873, 29112.854435727684, 29172.416551669274, 29340.0, 29539.0, 48238.27642585434, 48722.75638621926, 49123.0, 49315.753421232665, 49671.751641241564, 40547.56075715143, 42577.05881764864, 43553.78223108864, 43607.0, 43953.0, 41916.0, 42699.92003198745, 43065.0, 43197.136057279306, 43430.78284608557, 42465.575344246165, 42700.572994269656, 44190.11619767523, 44418.11163776771, 46422.30366544572, 34878.476822848184, 38880.80559597184, 39548.0, 39752.0, 39794.60205397909, 29655.0, 29979.250518737204, 30276.24309392283, 30371.544426833174, 30560.694393056674], "value": 19948.289079110025, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [393.6437524040744, 396.66085496900166, 408.5812042656277, 412.12423599850314, 422.8731380585825, 13867.722645547083, 18380.264789408426, 19198.90400547995, 20318.796812031876, 20390.69413958792, 13626.0, 13771.380287887045, 13790.379432925518, 18350.0, 18742.0, 5312.442193569677, 5434.7826086956475, 5458.4541545845495, 5465.562754979612, 5514.476124768141, 5637.238972738669, 5704.3154821421485, 5742.0, 5747.42525747424, 5792.623479473842, 5173.767180476888, 5425.782968681248, 5772.249607551013, 5787.04513755232, 5808.390119037483, 5169.250458683488, 5184.844454666366, 5199.714015729133, 5231.084560201987, 5245.973770131144, 4929.507049295078, 5089.694618322913, 5097.337346144977, 5109.437961824234, 5117.283580298761, 13980.58058258254, 14066.2966851657, 14161.29193540319, 14176.574702758933, 21675.45811354713, 2361.4787496654194, 2362.7400985891536, 2465.174166654173, 2466.987665061681, 2988.6861879502776, 9871.160951319147, 10438.478076096164, 10499.0, 14870.628234294229, 15226.847731522765, 1919.673655478572, 1951.180623720093, 1956.2957335359258, 1994.4216177308563, 2002.1590931808676, 81819.0, 85919.0, 86924.13075869223, 87940.0, 88663.0, 11038.558457661764, 11052.944735276273, 11244.044256238149, 11456.198066135457, 11550.422478876022, 15930.283137258852, 15948.0, 16060.678786424207, 16075.82976298208, 16102.75845862313, 8054.838903221903, 8263.834723305621, 8337.95831020841, 8413.013380250046, 8735.301175905912, 8212.384071194685, 8239.0, 8242.0, 8511.957440212884, 8549.145085491402, 4743.620510359163, 4745.6440766942615, 4824.131656301829, 4893.755312234374, 4894.119058569491, 1959.5590992026964, 1990.6715391960165, 2008.7545721652668, 2078.490769761418, 2089.6552068908763, 1022.5334232554461, 1037.3153718545875, 1041.2607048995146, 1048.1771809129796, 1104.8508451359126, 20206.29277975264, 20288.289909853083, 20354.0, 20415.0, 20873.973273875203, 1011.8836333821705, 1022.3559157730582, 1029.6602121299952, 1041.6822869024868, 1060.5598676549146, 10724.356538607708, 11408.25846320003, 11521.596744113916, 11565.537378504765, 11576.594819181288, 485356.0, 487536.0, 488346.0, 490333.0, 510521.0, 60635.0, 73925.63037184888, 94412.52793735988, 95779.0, 97023.0, 973.3478569358547, 1007.1439276614965, 1022.3610243597751, 1042.08296698906, 1053.1101219469535, 17087.914560427118, 17329.653406932044, 18086.457406277834, 18182.81817181811, 18525.722114168027, 42112.789436052626, 43044.56955430406, 43179.13641727211, 43613.0, 44077.11845763131, 60065.0, 60166.39833601608, 60336.0, 60467.0, 60964.39035609587, 7530.510516816389, 7769.223077692185, 7876.960615196887, 8175.550344731097, 8241.752747417588, 7887.84224315522, 11781.76436471283, 11865.813418658065, 12908.935455323039, 13335.0, 11822.645320640395, 11892.702682433008, 12134.696632583902, 12196.75606487883, 12512.810258204596, 6204.813855584159, 7740.26467485588, 11874.228175168586, 11903.46434410471, 11994.100442466675, 6460.741570337322, 8802.031776504708, 10988.120950323795, 11546.711332216762, 11772.411379430823, 8822.161894620001, 8876.955615221883, 9007.144321289466, 9224.215941644767, 9233.676821311223, 8798.780030499289, 12156.270623762603, 12488.25070495773, 12535.686607834878, 12587.0], "value": 9082.123646295418, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1493.7087267982745, 1503.6842263124743, 1664.4840099569135, 1710.5210541048511, 1787.0439314966488, 7459.104907411104, 8094.23104805044, 8208.75373738788, 8928.687495937635, 8933.463992160476, 8165.959170204141, 8282.461639993397, 8489.448185867914, 8548.70079547216, 8589.742307730778, 2297.7472478027403, 2357.1396440299254, 2357.4106473381653, 2359.5988681924027, 2363.0665886974634, 2230.9219177328796, 2300.1719381022817, 2328.382978510696, 2328.8020518255967, 2329.9767002330013, 2277.954440911181, 2291.278247352079, 2292.816574674022, 2295.1393227539675, 2304.7349554801162, 2226.053927080984, 2227.3429338345145, 2233.798958093771, 2235.552889422114, 2287.3824067501846, 2259.7401298850677, 2284.9543009139725, 2289.828262880291, 2292.7592602776804, 2296.8621882686925, 8568.871466928002, 8658.134186581354, 8664.696735614287, 8672.653093876237, 8682.218600326001, 4945.23348880924, 4983.202687569971, 4989.301497790312, 4996.850094497171, 5018.473060328686, 3157.226479512511, 3252.560904277916, 3398.677125673057, 3406.5741782277214, 3414.402479566066, 1191.5531675621642, 1202.1464760020397, 1229.5327775445362, 1245.9626211213679, 1247.681841130506, 11680.123990700646, 11842.052635789203, 11907.702307442383, 11956.043516518657, 11985.64043078709, 4292.720973136736, 4425.159219748238, 4523.208438523246, 4569.405977223007, 4576.542345765397, 10111.241656875764, 10156.746081348025, 10168.33905796121, 10207.438590877573, 10256.948715256376, 5106.157484015096, 5117.513836185556, 5190.480951904855, 5193.324867767166, 5206.97396513015, 4087.550369459357, 4598.494165641777, 4668.719876807402, 4716.174669432836, 4776.522347765195, 3674.669279764834, 3708.1100535871196, 3781.6785573226034, 3793.5827059023486, 3812.4471951566866, 1147.0995268714018, 1158.3976332307152, 1169.7536548579615, 1178.2871362825538, 1209.9395030248452, 854.2994744309607, 993.1707024634367, 1005.4872015272264, 1013.8124446977333, 1032.550840384435, 5692.260006199251, 5868.735906884201, 5872.207252021008, 5880.764769409261, 6087.147799308101, 425.1560652105568, 425.179403750764, 435.86270324848203, 443.312865059157, 444.37787098062324, 4128.236276288896, 4137.648299894482, 4157.625813676784, 4164.5210800757695, 4204.684648651363, 10428.217883658755, 10529.262951593468, 10554.736131596772, 10661.466926653637, 10666.093382062456, 10508.789824203473, 10514.894851051391, 10540.367577945195, 10548.261621686563, 10602.416867072385, 7469.962650186714, 7776.92223077762, 7828.569428681477, 7904.367650587939, 7928.088269848926, 5983.763749639892, 6042.8791424170395, 6086.573939824169, 6155.569110162425, 6187.84530386744, 9935.552900119657, 10041.347312424668, 10050.346727462691, 10066.798664026532, 10210.540525676213, 9426.387284826464, 9705.951470242604, 9797.06927841854, 9974.750631233986, 10146.137578305632, 6584.604923704593, 7416.147143078615, 7559.0, 7602.315791578784, 7798.844023119619, 8319.251267385964, 8417.537035463109, 8455.915440845512, 8489.0, 8500.70247541333, 7461.0, 7477.177510473953, 7484.887726683995, 7596.772096837104, 7764.6894124234395, 7222.494425390172, 7496.812579685551, 7517.323440890346, 7678.0, 7704.19105993885, 6520.445762110274, 6642.3025582315095, 6669.499787515859, 6679.131712877295, 6688.899666504909, 4916.459189489082, 5147.845564633067, 5159.871003224949, 5167.069927413102, 5202.297689811827, 5127.102757017582, 5137.948620513747, 5154.922676159786, 5195.376554813295, 5208.322918020633], "value": 4462.6941354809105, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [320.82194382117916, 334.0329745387104, 337.57128446872474, 341.6958906573152, 342.3478273888242, 5374.274472946151, 5400.8658181781775, 5529.889402211958, 5590.916136257954, 5621.915671264924, 5428.67427954322, 5493.121100623901, 5505.284313039299, 5516.6072865187925, 5525.475079867416, 4265.78671066447, 4269.978650106761, 4280.850170244042, 4284.250256205151, 4294.441722576061, 4147.502299724038, 4230.196262710076, 4242.321228603424, 4287.764172970486, 4318.460192475941, 4216.388623649569, 4217.7891105444605, 4222.345536441856, 4233.1956928183545, 4234.809433575481, 4208.957910420887, 4215.49414070312, 4218.535961044298, 4235.830566777326, 4259.339802330644, 3673.1918977824835, 3736.23407201523, 3747.063234191452, 3754.3617585010616, 3757.5678796938428, 5358.427954581823, 5365.275687782138, 5370.650907690988, 5399.730013499309, 5405.162199858989, 4926.201936293263, 4931.975340123312, 4939.333190019337, 4941.579965702919, 4970.801167953314, 5552.333719953632, 5748.396418376052, 5769.567282453832, 5817.574694199906, 5839.656878917873, 4077.4495443115097, 4109.671226301889, 4110.46563946688, 4115.54728979812, 4129.442525259082, 5980.43185897339, 6000.459958603703, 6071.210742603477, 6079.908801367983, 6109.725062372159, 4064.7154699170774, 4217.451731274915, 4263.339182426729, 4274.786260686953, 4285.528591854893, 4266.8293268269545, 4268.40242366069, 4282.700210985201, 4286.507051689034, 4325.610695037399, 4886.071646387246, 4920.926186107211, 4937.5556199942175, 4937.7531123444405, 4971.6022718183185, 5667.744951477111, 5842.620229685057, 5901.704914754245, 5909.734061967221, 5925.911111333247, 1422.879055280292, 1471.4114354258381, 1472.3815997280954, 1479.6818683982995, 1483.859033391826, 905.8550631898864, 935.1677007463363, 939.4738946190155, 950.064186776025, 953.1516949914582, 4784.545468180518, 4787.779116325384, 4813.975930120327, 4835.274708793709, 4917.246342048465, 5219.9903037330905, 5221.295125158055, 5224.608154388436, 5281.762320695578, 5338.626296159232, 4757.881052973703, 4913.336699545587, 4941.431735350408, 4947.554720075211, 4955.603551715854, 2741.424300896834, 2752.573351130538, 2754.793390495721, 2762.267998980272, 2778.5554311310093, 5338.903436007106, 5341.919871201935, 5352.9732351338, 5353.86615334612, 5356.678599284055, 4947.950520494821, 5203.947960520346, 5241.633085684041, 5264.973675131677, 5292.603054770908, 5343.812966546152, 5354.464553544614, 5384.6769193848495, 5385.892282154335, 5393.946060539502, 5197.0, 5214.634975551675, 5220.843374698765, 5237.423883372902, 5280.81517146898, 5205.843824685266, 5513.669179849222, 5907.734151963086, 5946.613470124428, 5953.523718102455, 6240.0, 6248.4064013918605, 6268.937310627018, 6275.592086514362, 6305.675808080355, 3978.8607398740905, 4231.936520952249, 4240.554741752195, 4243.89658688737, 4263.936040959326, 5790.276215473066, 5877.265341832271, 5899.528037757055, 5903.822885313448, 5998.920194364881, 5824.776796872535, 5825.446582574648, 5844.853878653068, 5866.941330586639, 5886.6173698709445, 5830.2129212555765, 5845.444682755132, 5860.179574859438, 5869.8239052826775, 5898.4101589840675, 5601.663900166003, 5780.971095144666, 5800.100984347433, 5812.883742325214, 5832.912506312324, 5869.7945571904775, 5892.646441213541, 5897.823065308047, 5922.170896074467, 5929.822105336847, 5630.5777066720975, 5709.942900570941, 5715.480796522364, 5755.827325180251, 5766.538676905753], "value": 4277.58151190444, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [760.3043215457853, 773.1920143450094, 799.3125911715923, 839.6364234679373, 884.641720103358, 14220.28898555072, 14618.634534136625, 14682.999999999987, 14705.264736763173, 14728.6317842054, 14239.501617443366, 14351.497697580588, 14405.567832965002, 14422.134671919666, 14442.422303107864, 815.8694608862584, 819.0703551469096, 824.8102936324649, 825.5170725125809, 825.5789547330844, 796.7808852565532, 821.256762629818, 822.995885020577, 823.9423240373176, 827.1976183102411, 852.4203541591716, 855.1747563601124, 855.4696088425154, 856.3919617071887, 858.2790456016944, 841.8484672758901, 849.9957500212521, 851.4380508864182, 852.0669866496177, 853.1724227499316, 626.3798839149255, 626.677261210477, 628.6102616377875, 630.2279707358495, 630.5586089737202, 15046.849531504655, 15094.924525377413, 15101.942863999524, 15105.848941510554, 15113.0, 14687.55937321882, 14746.557603271918, 14795.630109247248, 14956.40174393023, 15090.849091509053, 12518.436670349765, 12570.37516815302, 12623.368831558386, 12862.292573908431, 13549.254790986492, 3863.208042351311, 3920.372740361557, 3921.88234352967, 3958.841646334143, 3995.760254384746, 88818.0, 89174.5541272296, 89254.5537272316, 90073.0, 90595.54702226447, 10928.722477920139, 11010.284331518425, 11406.942965285121, 11571.132165087653, 11701.122415818678, 21599.0, 21686.156676682658, 21753.564928701653, 22022.559548809255, 22026.88986555057, 8206.138355472589, 8494.320454363637, 8497.065322814486, 8498.787530311669, 8610.268127209132, 5012.573931215815, 5016.046951079284, 5107.821226257138, 5173.0, 5246.0, 3428.177237462991, 3531.081918701156, 3539.380608393521, 3545.62770909056, 3555.0579096539436, 622.343427683789, 630.8675178212627, 631.6589041917313, 632.908228306893, 633.6166619195412, 747.9513831600929, 748.5037400270052, 786.5752493653363, 787.7321710618418, 806.2662976691183, 8806.25146862511, 10085.294029418017, 10126.493675316206, 10348.327358721659, 10353.844692329621, 672.7914346552584, 730.8486459988982, 741.5439504704676, 748.8988986486863, 757.8560073586001, 5017.996191387724, 5019.272205530177, 5030.320906677625, 5044.0920634286185, 5097.694138351637, 127870.0, 128346.0, 129160.35419823028, 129403.35298323448, 130299.34850325878, 111781.0, 111926.0, 114841.0, 115256.42371788256, 115988.0, 78476.21523784804, 81364.3727125466, 97737.0, 97767.51116244373, 100365.49817250867, 9980.750481237737, 10209.030142136486, 10214.438205898747, 10334.431606261727, 10350.948245258725, 50838.491615083374, 52212.738936305075, 52631.78850135299, 53600.46399535955, 53862.96027797853, 72317.0, 80937.19062809533, 82052.58973705093, 82291.0, 82643.0, 12891.484340626645, 13186.208827470382, 13280.867191327963, 13895.58313250604, 14178.36044106467, 13331.600051998455, 14692.338844752225, 14701.41194352214, 14831.777523337374, 15074.397024118913, 14309.856901430852, 14476.782848257073, 14566.41734330615, 14684.85315146835, 14741.894357922984, 13275.80086298687, 13619.114757540729, 13699.794503082661, 13710.245936473191, 13973.231472269123, 12903.385910403862, 14013.859861401255, 14135.858641413453, 14177.858221417653, 14495.637609059859, 10249.472049844342, 10677.679669609613, 10806.513706883052, 11631.709207269885, 11731.824022639837, 11891.405429728651, 12357.691057723629, 12376.0, 12474.875251247371, 12707.618771436872], "value": 7835.534203009805, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1556.3000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 111.0, 111.0, 111.0, 113.0, 112.0, 118.0, 112.0, 112.0, 115.0], "value": 112.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 124.0, 151.0, 183.0, 123.0, 148.0, 158.0, 122.0, 178.0, 120.0], "value": 146.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 162.0, 163.0, 164.0, 162.0, 165.0, 169.0, 163.0, 163.0, 162.0], "value": 163.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 76.0, 187.0, 76.0, 75.0, 76.0, 75.0, 164.0, 77.0], "value": 95.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 85.0, 142.0, 86.0, 87.0, 85.0, 140.0, 85.0, 85.0, 149.0], "value": 103.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 118.0, 117.0, 117.0, 117.0, 117.0, 118.0, 118.0, 121.0], "value": 117.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 148.0, 148.0, 147.0, 147.0, 148.0, 146.0, 147.0, 147.0, 149.0], "value": 148.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [98.0, 96.0, 96.0, 100.0, 96.0, 96.0, 96.0, 95.0, 96.0, 96.0], "value": 96.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 52.0, 59.0, 54.0, 56.0, 57.0, 53.0, 54.0, 54.0, 56.0], "value": 54.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 62.0, 62.0, 62.0, 62.0, 62.0, 63.0, 62.0, 62.0, 63.0], "value": 62.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 85.0, 83.0, 80.0, 80.0, 78.0, 82.0, 79.0, 78.0, 82.0], "value": 82.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [140.0, 126.0, 125.0, 126.0, 125.0, 131.0, 144.0, 136.0, 186.0, 137.0], "value": 137.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [172.0, 165.0, 169.0, 170.0, 179.0, 165.0, 168.0, 169.0, 167.0, 176.0], "value": 170.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 66.0, 66.0, 67.0, 68.0, 68.0, 65.0, 65.0, 63.0, 65.0], "value": 66.9, "unit": "score"}]}]} 16:25:55 INFO - Return code: 0 16:25:55 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:25:55 ERROR - # TBPL SUCCESS # 16:25:55 INFO - Running post-action listener: _resource_record_post_action 16:25:55 INFO - [mozharness: 2016-08-17 23:25:55.276212Z] Finished run-tests step (success) 16:25:55 INFO - Running post-run listener: _resource_record_post_run 16:25:55 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 0; Write bytes: 408870912; Read time: 0; Write time: 415724 16:25:55 INFO - TinderboxPrint: CPU usage
13.4% 16:25:55 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 16:25:55 INFO - TinderboxPrint: I/O write bytes / time
408,870,912 / 415,724 16:25:55 INFO - TinderboxPrint: CPU idle
8,230.2 (86.5%) 16:25:55 INFO - TinderboxPrint: CPU user
1,219.2 (12.8%) 16:25:55 INFO - TinderboxPrint: Swap in / out
0 / 0 16:25:55 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 117604352; Read time: 0; Write time: 126168 16:25:55 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 290652160; Read time: 0; Write time: 289556 16:25:55 INFO - Running post-run listener: _upload_blobber_files 16:25:55 INFO - Blob upload gear active. 16:25:55 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:25:55 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 16:25:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:25:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:25:56 INFO - (blobuploader) - INFO - Open directory for files ... 16:25:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:25:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:25:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:25:57 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:25:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:25:57 INFO - (blobuploader) - INFO - Done attempting. 16:25:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:25:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:25:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:25:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:25:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:25:58 INFO - (blobuploader) - INFO - Done attempting. 16:25:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:25:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:25:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:26:01 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:26:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:26:01 INFO - (blobuploader) - INFO - Done attempting. 16:26:01 INFO - (blobuploader) - INFO - Iteration through files over. 16:26:01 INFO - Return code: 0 16:26:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:26:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:26:01 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8b82c6de3ccca139652fe7a215b1320f8f61c56c49b5949b2a9dcabda3d7b7dfbc0cd52976e9a973e7e5ca26d6e363d2ddac5e85c48be024942b526be1ea5fe7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/88fc5ff964529c3812dbde1292aeb0b597810fe19e4797f6de9843e30e0a5bb64ea533cde185b507161df700341862346ec46eff4a318511e7ed6839a8bd01f1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/e198d596e639af027d68e0736da7f308fbd915287312b254c1643b553af7424976c2d6c8aaa33c6dbf213f40655e09bd4eae7c2fd6e955151d861bc7cb952a84"} 16:26:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:26:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:26:01 INFO - Contents: 16:26:01 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8b82c6de3ccca139652fe7a215b1320f8f61c56c49b5949b2a9dcabda3d7b7dfbc0cd52976e9a973e7e5ca26d6e363d2ddac5e85c48be024942b526be1ea5fe7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/88fc5ff964529c3812dbde1292aeb0b597810fe19e4797f6de9843e30e0a5bb64ea533cde185b507161df700341862346ec46eff4a318511e7ed6839a8bd01f1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/e198d596e639af027d68e0736da7f308fbd915287312b254c1643b553af7424976c2d6c8aaa33c6dbf213f40655e09bd4eae7c2fd6e955151d861bc7cb952a84"} 16:26:01 INFO - Running post-run listener: copy_logs_to_upload_dir 16:26:01 INFO - Copying logs to upload dir... 16:26:01 INFO - mkdir: /builds/slave/test/build/upload/logs 16:26:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.127352 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-08-17 16:26:00.119492) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-17 16:26:00.127077) ========= 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=fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432 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/sha512/8b82c6de3ccca139652fe7a215b1320f8f61c56c49b5949b2a9dcabda3d7b7dfbc0cd52976e9a973e7e5ca26d6e363d2ddac5e85c48be024942b526be1ea5fe7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/88fc5ff964529c3812dbde1292aeb0b597810fe19e4797f6de9843e30e0a5bb64ea533cde185b507161df700341862346ec46eff4a318511e7ed6839a8bd01f1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/e198d596e639af027d68e0736da7f308fbd915287312b254c1643b553af7424976c2d6c8aaa33c6dbf213f40655e09bd4eae7c2fd6e955151d861bc7cb952a84"} build_url:https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011340 build_url: 'https://queue.taskcluster.net/v1/task/dnfTDhoMT4qKaSW0l98Q7A/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8b82c6de3ccca139652fe7a215b1320f8f61c56c49b5949b2a9dcabda3d7b7dfbc0cd52976e9a973e7e5ca26d6e363d2ddac5e85c48be024942b526be1ea5fe7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/88fc5ff964529c3812dbde1292aeb0b597810fe19e4797f6de9843e30e0a5bb64ea533cde185b507161df700341862346ec46eff4a318511e7ed6839a8bd01f1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/e198d596e639af027d68e0736da7f308fbd915287312b254c1643b553af7424976c2d6c8aaa33c6dbf213f40655e09bd4eae7c2fd6e955151d861bc7cb952a84"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-17 16:26:00.155747) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-17 16:26:00.156137) ========= 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=fa44defc139c4ba8574fe040000001db-1471475122.62173-1279921432 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004522 ========= master_lag: 0.07 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-17 16:26:00.234486) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-17 16:26:00.237867) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-17 16:26:00.238227) ========= ========= Total master_lag: 0.16 =========