builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-064 starttime: 1460830573.36 results: success (0) buildid: 20160416083214 builduid: e51a8f8729fb400ca6950d9d6dc66848 revision: abe15212891c03d58bee30a6ec38e89bcb4abef3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.364782) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.365262) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.365579) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.384941) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.385299) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-16 11:16:15-- 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% 222M=0s 2016-04-16 11:16:15 (222 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.124109 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.522869) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.523247) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018731 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.581456) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:13.581830) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev abe15212891c03d58bee30a6ec38e89bcb4abef3 --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 abe15212891c03d58bee30a6ec38e89bcb4abef3 --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=a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-16 11:16:15,868 truncating revision to first 12 chars 2016-04-16 11:16:15,868 Setting DEBUG logging. 2016-04-16 11:16:15,868 attempt 1/10 2016-04-16 11:16:15,869 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/abe15212891c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-16 11:16:16,353 unpacking tar archive at: fx-team-abe15212891c/testing/mozharness/ program finished with exit code 0 elapsedTime=0.769659 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:14.364307) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:14.364636) ========= script_repo_revision: abe15212891c03d58bee30a6ec38e89bcb4abef3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:14.365026) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:14.365313) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-16 11:16:14.375221) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-04-16 11:16:14.375518) ========= /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=a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:16:16 INFO - MultiFileLogger online at 20160416 11:16:16 in /builds/slave/test 11:16:16 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 11:16:16 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:16:16 INFO - {'append_to_log': False, 11:16:16 INFO - 'base_work_dir': '/builds/slave/test', 11:16:16 INFO - 'blob_upload_branch': 'Fx-Team', 11:16:16 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:16:16 INFO - 'branch': 'Fx-Team', 11:16:16 INFO - 'buildbot_json_path': 'buildprops.json', 11:16:16 INFO - 'config_files': ('talos/linux_config.py',), 11:16:16 INFO - 'default_actions': ('clobber', 11:16:16 INFO - 'read-buildbot-config', 11:16:16 INFO - 'download-and-extract', 11:16:16 INFO - 'populate-webroot', 11:16:16 INFO - 'create-virtualenv', 11:16:16 INFO - 'install', 11:16:16 INFO - 'run-tests'), 11:16:16 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:16:16 INFO - 'download_minidump_stackwalk': True, 11:16:16 INFO - 'download_symbols': 'ondemand', 11:16:16 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:16:16 INFO - 'tooltool.py': '/tools/tooltool.py', 11:16:16 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:16:16 INFO - '/tools/misc-python/virtualenv.py')}, 11:16:16 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:16:16 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:16:16 INFO - 'installer_path': 'installer.exe', 11:16:16 INFO - 'log_level': 'info', 11:16:16 INFO - 'log_name': 'talos', 11:16:16 INFO - 'log_to_console': True, 11:16:16 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:16:16 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:16:16 INFO - 'opt_config_files': (), 11:16:16 INFO - 'pip_index': False, 11:16:16 INFO - 'sps_profile': False, 11:16:16 INFO - 'sps_profile_interval': 0, 11:16:16 INFO - 'suite': 'dromaeojs-e10s', 11:16:16 INFO - 'system_bits': '32', 11:16:16 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:16:16 INFO - 'title': 'talos-linux64-ix-064', 11:16:16 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:16:16 INFO - 'use_talos_json': True, 11:16:16 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:16:16 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:16:16 INFO - 'work_dir': 'build'} 11:16:16 INFO - ##### 11:16:16 INFO - ##### Running clobber step. 11:16:16 INFO - ##### 11:16:16 INFO - Running pre-action listener: _resource_record_pre_action 11:16:16 INFO - Running main action method: clobber 11:16:16 INFO - rmtree: /builds/slave/test/build 11:16:16 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:16:17 INFO - Running post-action listener: _resource_record_post_action 11:16:17 INFO - ##### 11:16:17 INFO - ##### Running read-buildbot-config step. 11:16:17 INFO - ##### 11:16:17 INFO - Running pre-action listener: _resource_record_pre_action 11:16:17 INFO - Running main action method: read_buildbot_config 11:16:17 INFO - Using buildbot properties: 11:16:17 INFO - { 11:16:17 INFO - "project": "", 11:16:17 INFO - "product": "firefox", 11:16:17 INFO - "script_repo_revision": "production", 11:16:17 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 11:16:17 INFO - "repository": "", 11:16:17 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 11:16:17 INFO - "buildid": "20160416083214", 11:16:17 INFO - "pgo_build": "True", 11:16:17 INFO - "basedir": "/builds/slave/test", 11:16:17 INFO - "buildnumber": 283, 11:16:17 INFO - "slavename": "talos-linux64-ix-064", 11:16:17 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 11:16:17 INFO - "platform": "ubuntu64_hw", 11:16:17 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:16:17 INFO - "branch": "fx-team", 11:16:17 INFO - "repo_path": "integration/fx-team", 11:16:17 INFO - "revision": "abe15212891c03d58bee30a6ec38e89bcb4abef3", 11:16:17 INFO - "stage_platform": "linux64-pgo", 11:16:17 INFO - "builduid": "e51a8f8729fb400ca6950d9d6dc66848", 11:16:17 INFO - "slavebuilddir": "test" 11:16:17 INFO - } 11:16:17 INFO - Found installer url https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 11:16:17 INFO - Running post-action listener: _resource_record_post_action 11:16:17 INFO - ##### 11:16:17 INFO - ##### Running download-and-extract step. 11:16:17 INFO - ##### 11:16:17 INFO - Running pre-action listener: _resource_record_pre_action 11:16:17 INFO - Running main action method: download_and_extract 11:16:17 INFO - mkdir: /builds/slave/test/build/tests 11:16:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:17 INFO - https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:16:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 11:16:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 11:16:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 11:16:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 11:16:19 INFO - Downloaded 1361 bytes. 11:16:19 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 11:16:19 INFO - Using the following test package requirements: 11:16:19 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 11:16:19 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:16:19 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:16:19 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:16:19 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:16:19 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:16:19 INFO - u'jsshell-linux-x86_64.zip'], 11:16:19 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:16:19 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:16:19 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 11:16:19 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:16:19 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:16:19 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:16:19 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:16:19 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:16:19 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:16:19 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:16:19 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:16:19 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:19 INFO - https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:16:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:16:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:16:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:16:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:16:21 INFO - Downloaded 23775019 bytes. 11:16:21 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:16:21 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:16:22 INFO - Return code: 0 11:16:22 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 11:16:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:22 INFO - https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:16:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:16:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:16:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:16:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:16:24 INFO - Downloaded 23775019 bytes. 11:16:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:16:24 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:16:25 INFO - Return code: 0 11:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:25 INFO - https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:16:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 11:16:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 11:16:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 11:16:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 11:16:27 INFO - Downloaded 10841076 bytes. 11:16:27 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:16:27 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 11:16:27 INFO - Return code: 0 11:16:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:27 INFO - https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:16:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:16:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:16:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:16:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 11:16:31 INFO - Downloaded 58234768 bytes. 11:16:31 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:16:31 INFO - mkdir: /builds/slave/test/properties 11:16:31 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:16:31 INFO - Writing to file /builds/slave/test/properties/build_url 11:16:31 INFO - Contents: 11:16:31 INFO - build_url:https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:16:32 INFO - Running post-action listener: _resource_record_post_action 11:16:32 INFO - Running post-action listener: set_extra_try_arguments 11:16:32 INFO - ##### 11:16:32 INFO - ##### Running populate-webroot step. 11:16:32 INFO - ##### 11:16:32 INFO - Running pre-action listener: _resource_record_pre_action 11:16:32 INFO - Running main action method: populate_webroot 11:16:32 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:16:32 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:16:32 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:16:32 INFO - '--tppagecycles', 11:16:32 INFO - '7'], 11:16:32 INFO - 'tests': ['tsvgm']}}, 11:16:32 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:16:32 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:16:32 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:16:32 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:16:32 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:16:32 INFO - 'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:16:32 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:16:32 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:16:32 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:16:32 INFO - 'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['damp', 'tps']}, 11:16:32 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:16:32 INFO - 'tests': ['damp', 'tps']}, 11:16:32 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['dromaeo_dom']}, 11:16:32 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:16:32 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['a11yr', 11:16:32 INFO - 'ts_paint', 11:16:32 INFO - 'tpaint', 11:16:32 INFO - 'sessionrestore', 11:16:32 INFO - 'sessionrestore_no_auto_restore', 11:16:32 INFO - 'tabpaint']}, 11:16:32 INFO - 'other-e10s': {'tests': ['a11yr', 11:16:32 INFO - 'ts_paint', 11:16:32 INFO - 'tpaint', 11:16:32 INFO - 'sessionrestore', 11:16:32 INFO - 'sessionrestore_no_auto_restore', 11:16:32 INFO - 'tabpaint']}, 11:16:32 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:16:32 INFO - 'ts_paint', 11:16:32 INFO - 'tpaint', 11:16:32 INFO - 'sessionrestore', 11:16:32 INFO - 'sessionrestore_no_auto_restore', 11:16:32 INFO - 'tabpaint']}, 11:16:32 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:16:32 INFO - 'ts_paint', 11:16:32 INFO - 'tpaint', 11:16:32 INFO - 'sessionrestore', 11:16:32 INFO - 'sessionrestore_no_auto_restore', 11:16:32 INFO - 'tabpaint']}, 11:16:32 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['a11yr', 11:16:32 INFO - 'ts_paint', 11:16:32 INFO - 'tpaint', 11:16:32 INFO - 'sessionrestore', 11:16:32 INFO - 'sessionrestore_no_auto_restore', 11:16:32 INFO - 'tabpaint']}, 11:16:32 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['a11yr', 11:16:32 INFO - 'ts_paint', 11:16:32 INFO - 'tpaint', 11:16:32 INFO - 'sessionrestore', 11:16:32 INFO - 'sessionrestore_no_auto_restore', 11:16:32 INFO - 'tabpaint']}, 11:16:32 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['tsvgx', 11:16:32 INFO - 'tsvgr_opacity', 11:16:32 INFO - 'tart', 11:16:32 INFO - 'tscrollx', 11:16:32 INFO - 'cart']}, 11:16:32 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:16:32 INFO - 'tsvgr_opacity', 11:16:32 INFO - 'tart', 11:16:32 INFO - 'tscrollx', 11:16:32 INFO - 'cart']}, 11:16:32 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:16:32 INFO - 'talos_options': ['--disable-e10s'], 11:16:32 INFO - 'tests': ['tp5o']}, 11:16:32 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:16:32 INFO - 'tests': ['tp5o']}, 11:16:32 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:16:32 INFO - 'talos_options': ['--disable-e10s', 11:16:32 INFO - '--xperf_path', 11:16:32 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:16:32 INFO - 'tests': ['tp5n']}, 11:16:32 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:16:32 INFO - 'talos_options': ['--xperf_path', 11:16:32 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:16:32 INFO - 'tests': ['tp5n']}}, 11:16:32 INFO - 'talos.zip': {'path': '', 11:16:32 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:16:32 INFO - Running post-action listener: _resource_record_post_action 11:16:32 INFO - ##### 11:16:32 INFO - ##### Running create-virtualenv step. 11:16:32 INFO - ##### 11:16:32 INFO - Running pre-action listener: _resource_record_pre_action 11:16:32 INFO - Running main action method: create_virtualenv 11:16:32 INFO - Creating virtualenv /builds/slave/test/build/venv 11:16:32 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 11:16:32 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:16:32 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:16:32 INFO - Using real prefix '/usr' 11:16:32 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:16:33 INFO - Installing distribute.............................................................................................................................................................................................done. 11:16:35 INFO - Installing pip.................done. 11:16:35 INFO - Return code: 0 11:16:35 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:16:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 11:16:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 11:16:35 INFO - Using env: {'DISPLAY': ':0', 11:16:35 INFO - 'HOME': '/home/cltbld', 11:16:35 INFO - 'LANG': 'en_US.UTF-8', 11:16:35 INFO - 'LANGUAGE': 'en_US:en', 11:16:35 INFO - 'LOGNAME': 'cltbld', 11:16:35 INFO - 'MAIL': '/var/mail/cltbld', 11:16:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:35 INFO - 'MOZ_NO_REMOTE': '1', 11:16:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:35 INFO - 'NO_EM_RESTART': '1', 11:16:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:35 INFO - 'PWD': '/builds/slave/test', 11:16:35 INFO - 'SHELL': '/bin/bash', 11:16:35 INFO - 'SHLVL': '1', 11:16:35 INFO - 'TERM': 'linux', 11:16:35 INFO - 'TMOUT': '86400', 11:16:35 INFO - 'USER': 'cltbld', 11:16:35 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:35 INFO - '_': '/tools/buildbot/bin/python'} 11:16:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:35 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 11:16:35 INFO - Cleaning up... 11:16:35 INFO - Return code: 0 11:16:35 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 11:16:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 11:16:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 11:16:35 INFO - Using env: {'DISPLAY': ':0', 11:16:35 INFO - 'HOME': '/home/cltbld', 11:16:35 INFO - 'LANG': 'en_US.UTF-8', 11:16:35 INFO - 'LANGUAGE': 'en_US:en', 11:16:35 INFO - 'LOGNAME': 'cltbld', 11:16:35 INFO - 'MAIL': '/var/mail/cltbld', 11:16:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:35 INFO - 'MOZ_NO_REMOTE': '1', 11:16:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:35 INFO - 'NO_EM_RESTART': '1', 11:16:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:35 INFO - 'PWD': '/builds/slave/test', 11:16:35 INFO - 'SHELL': '/bin/bash', 11:16:35 INFO - 'SHLVL': '1', 11:16:35 INFO - 'TERM': 'linux', 11:16:35 INFO - 'TMOUT': '86400', 11:16:35 INFO - 'USER': 'cltbld', 11:16:35 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:35 INFO - '_': '/tools/buildbot/bin/python'} 11:16:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:35 INFO - Downloading/unpacking psutil>=0.7.1 11:16:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:16:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:16:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:16:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:16:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:16:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:16:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:16:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:16:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:16:37 INFO - Installing collected packages: psutil 11:16:37 INFO - Running setup.py install for psutil 11:16:37 INFO - building 'psutil._psutil_linux' extension 11:16:37 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 11:16:37 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 11:16:37 INFO - building 'psutil._psutil_posix' extension 11:16:37 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 11:16:37 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 11:16:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:16:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:16:38 INFO - Successfully installed psutil 11:16:38 INFO - Cleaning up... 11:16:38 INFO - Return code: 0 11:16:38 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 11:16:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 11:16:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 11:16:38 INFO - Using env: {'DISPLAY': ':0', 11:16:38 INFO - 'HOME': '/home/cltbld', 11:16:38 INFO - 'LANG': 'en_US.UTF-8', 11:16:38 INFO - 'LANGUAGE': 'en_US:en', 11:16:38 INFO - 'LOGNAME': 'cltbld', 11:16:38 INFO - 'MAIL': '/var/mail/cltbld', 11:16:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:38 INFO - 'MOZ_NO_REMOTE': '1', 11:16:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:38 INFO - 'NO_EM_RESTART': '1', 11:16:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:38 INFO - 'PWD': '/builds/slave/test', 11:16:38 INFO - 'SHELL': '/bin/bash', 11:16:38 INFO - 'SHLVL': '1', 11:16:38 INFO - 'TERM': 'linux', 11:16:38 INFO - 'TMOUT': '86400', 11:16:38 INFO - 'USER': 'cltbld', 11:16:38 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:38 INFO - '_': '/tools/buildbot/bin/python'} 11:16:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:38 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 11:16:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:16:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:16:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:16:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:16:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:16:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:16:40 INFO - Downloading mozsystemmonitor-0.0.tar.gz 11:16:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:16:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 11:16:40 INFO - Installing collected packages: mozsystemmonitor 11:16:40 INFO - Running setup.py install for mozsystemmonitor 11:16:40 INFO - Successfully installed mozsystemmonitor 11:16:40 INFO - Cleaning up... 11:16:40 INFO - Return code: 0 11:16:40 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:16:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:40 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 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16:40 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 11:16:40 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 11:16:40 INFO - Using env: {'DISPLAY': ':0', 11:16:40 INFO - 'HOME': '/home/cltbld', 11:16:40 INFO - 'LANG': 'en_US.UTF-8', 11:16:40 INFO - 'LANGUAGE': 'en_US:en', 11:16:40 INFO - 'LOGNAME': 'cltbld', 11:16:40 INFO - 'MAIL': '/var/mail/cltbld', 11:16:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:40 INFO - 'MOZ_NO_REMOTE': '1', 11:16:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:40 INFO - 'NO_EM_RESTART': '1', 11:16:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:40 INFO - 'PWD': '/builds/slave/test', 11:16:40 INFO - 'SHELL': '/bin/bash', 11:16:40 INFO - 'SHLVL': '1', 11:16:40 INFO - 'TERM': 'linux', 11:16:40 INFO - 'TMOUT': '86400', 11:16:40 INFO - 'USER': 'cltbld', 11:16:40 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:40 INFO - '_': '/tools/buildbot/bin/python'} 11:16:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:40 INFO - Downloading/unpacking blobuploader==1.2.4 11:16:40 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 11:16:40 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 11:16:40 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 11:16:40 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 11:16:40 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 11:16:40 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 11:16:42 INFO - Downloading blobuploader-1.2.4.tar.gz 11:16:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:16:42 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:16:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:16:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:16:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:16:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:16:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:16:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:16:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:16:43 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16:43 INFO - Downloading docopt-0.6.1.tar.gz 11:16:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:16:43 INFO - Installing collected packages: blobuploader, requests, docopt 11:16:43 INFO - Running setup.py install for blobuploader 11:16:43 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:16:43 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:16:43 INFO - Running setup.py install for requests 11:16:43 INFO - Running setup.py install for docopt 11:16:43 INFO - Successfully installed blobuploader requests docopt 11:16:43 INFO - Cleaning up... 11:16:43 INFO - Return code: 0 11:16:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:16:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:16:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:16:43 INFO - Using env: {'DISPLAY': ':0', 11:16:43 INFO - 'HOME': '/home/cltbld', 11:16:43 INFO - 'LANG': 'en_US.UTF-8', 11:16:43 INFO - 'LANGUAGE': 'en_US:en', 11:16:43 INFO - 'LOGNAME': 'cltbld', 11:16:43 INFO - 'MAIL': '/var/mail/cltbld', 11:16:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:43 INFO - 'MOZ_NO_REMOTE': '1', 11:16:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:43 INFO - 'NO_EM_RESTART': '1', 11:16:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:43 INFO - 'PWD': '/builds/slave/test', 11:16:43 INFO - 'SHELL': '/bin/bash', 11:16:43 INFO - 'SHLVL': '1', 11:16:43 INFO - 'TERM': 'linux', 11:16:43 INFO - 'TMOUT': '86400', 11:16:43 INFO - 'USER': 'cltbld', 11:16:43 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:43 INFO - '_': '/tools/buildbot/bin/python'} 11:16:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:16:44 INFO - Running setup.py (path:/tmp/pip-29w5hr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:16:44 INFO - Running setup.py (path:/tmp/pip-rM2oMB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:16:44 INFO - Running setup.py (path:/tmp/pip-uzJHx3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:16:44 INFO - Running setup.py (path:/tmp/pip-6FArAj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:16:44 INFO - Running setup.py (path:/tmp/pip-zEEm_v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:16:44 INFO - Running setup.py (path:/tmp/pip-6FVtn7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:16:44 INFO - Running setup.py (path:/tmp/pip-9p163K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:16:44 INFO - Running setup.py (path:/tmp/pip-NR93gj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:16:44 INFO - Running setup.py (path:/tmp/pip-YUO6O6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:16:44 INFO - Running setup.py (path:/tmp/pip-y2JJhl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:16:44 INFO - Running setup.py (path:/tmp/pip-St4IGu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:16:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:16:44 INFO - Running setup.py (path:/tmp/pip-TIageF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:16:45 INFO - Running setup.py (path:/tmp/pip-HGSh79-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:16:45 INFO - Running setup.py (path:/tmp/pip-CW9bAN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:16:45 INFO - Running setup.py (path:/tmp/pip-WiecbB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:16:45 INFO - Running setup.py (path:/tmp/pip-CdNK1w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:16:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:16:45 INFO - Running setup.py (path:/tmp/pip-Gec8LK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:16:45 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:16:45 INFO - Running setup.py install for manifestparser 11:16:45 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:16:45 INFO - Running setup.py install for mozcrash 11:16:45 INFO - Running setup.py install for mozdebug 11:16:45 INFO - Running setup.py install for mozdevice 11:16:45 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:16:45 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:16:45 INFO - Running setup.py install for mozfile 11:16:45 INFO - Running setup.py install for mozhttpd 11:16:45 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:16:45 INFO - Running setup.py install for mozinfo 11:16:46 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Running setup.py install for mozInstall 11:16:46 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Running setup.py install for mozleak 11:16:46 INFO - Running setup.py install for mozlog 11:16:46 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Running setup.py install for moznetwork 11:16:46 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Running setup.py install for mozprocess 11:16:46 INFO - Running setup.py install for mozprofile 11:16:46 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Running setup.py install for mozrunner 11:16:46 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:16:46 INFO - Running setup.py install for mozscreenshot 11:16:46 INFO - Running setup.py install for moztest 11:16:47 INFO - Running setup.py install for mozversion 11:16:47 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:16:47 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:16:47 INFO - Cleaning up... 11:16:47 INFO - Return code: 0 11:16:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:16:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:47 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 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16:47 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 11:16:47 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 11:16:47 INFO - Using env: {'DISPLAY': ':0', 11:16:47 INFO - 'HOME': '/home/cltbld', 11:16:47 INFO - 'LANG': 'en_US.UTF-8', 11:16:47 INFO - 'LANGUAGE': 'en_US:en', 11:16:47 INFO - 'LOGNAME': 'cltbld', 11:16:47 INFO - 'MAIL': '/var/mail/cltbld', 11:16:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:47 INFO - 'MOZ_NO_REMOTE': '1', 11:16:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:47 INFO - 'NO_EM_RESTART': '1', 11:16:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:47 INFO - 'PWD': '/builds/slave/test', 11:16:47 INFO - 'SHELL': '/bin/bash', 11:16:47 INFO - 'SHLVL': '1', 11:16:47 INFO - 'TERM': 'linux', 11:16:47 INFO - 'TMOUT': '86400', 11:16:47 INFO - 'USER': 'cltbld', 11:16:47 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:47 INFO - '_': '/tools/buildbot/bin/python'} 11:16:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:16:47 INFO - Running setup.py (path:/tmp/pip-Z31ZGm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:16:47 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)) 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:16:47 INFO - Running setup.py (path:/tmp/pip-pcXMQF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:16:47 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)) 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:16:47 INFO - Running setup.py (path:/tmp/pip-Xy65Yk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:16:47 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)) 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:16:47 INFO - Running setup.py (path:/tmp/pip-YtHzF9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:16:47 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)) 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:16:47 INFO - Running setup.py (path:/tmp/pip-PQT5_H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:16:47 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)) 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:16:47 INFO - Running setup.py (path:/tmp/pip-9ycMMt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:16:47 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)) 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:16:47 INFO - Running setup.py (path:/tmp/pip-8CMXC7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:16:47 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)) 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:16:47 INFO - Running setup.py (path:/tmp/pip-ZjPJ3F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:16:47 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)) 11:16:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:16:47 INFO - Running setup.py (path:/tmp/pip-SRHGpk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:16:48 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)) 11:16:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:16:48 INFO - Running setup.py (path:/tmp/pip-IODBLB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:16:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 11:16:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:16:48 INFO - Running setup.py (path:/tmp/pip-lgABRe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:16:48 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)) 11:16:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:16:48 INFO - Running setup.py (path:/tmp/pip-MHVeK4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:16:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 11:16:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:16:48 INFO - Running setup.py (path:/tmp/pip-ExjBO6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:16:48 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)) 11:16:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:16:48 INFO - Running setup.py (path:/tmp/pip-mNxupn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:16:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 11:16:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:16:48 INFO - Running setup.py (path:/tmp/pip-xaZonl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:16:48 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)) 11:16:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:16:48 INFO - Running setup.py (path:/tmp/pip-sXd30z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:16:48 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)) 11:16:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:16:48 INFO - Running setup.py (path:/tmp/pip-HHDjgA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:16:48 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)) 11:16:48 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)) 11:16:48 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)) 11:16:48 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)) 11:16:48 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)) 11:16:48 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)) 11:16:48 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16:50 INFO - Downloading blessings-1.6.tar.gz 11:16:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:16:50 INFO - Installing collected packages: blessings 11:16:50 INFO - Running setup.py install for blessings 11:16:50 INFO - Successfully installed blessings 11:16:50 INFO - Cleaning up... 11:16:50 INFO - Return code: 0 11:16:50 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:16:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:16:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:16:50 INFO - Reading from file tmpfile_stdout 11:16:50 INFO - Current package versions: 11:16:50 INFO - argparse == 1.2.1 11:16:50 INFO - blessings == 1.6 11:16:50 INFO - blobuploader == 1.2.4 11:16:50 INFO - docopt == 0.6.1 11:16:50 INFO - manifestparser == 1.1 11:16:50 INFO - mozInstall == 1.12 11:16:50 INFO - mozcrash == 0.17 11:16:50 INFO - mozdebug == 0.1 11:16:50 INFO - mozdevice == 0.48 11:16:50 INFO - mozfile == 1.2 11:16:50 INFO - mozhttpd == 0.7 11:16:50 INFO - mozinfo == 0.9 11:16:50 INFO - mozleak == 0.1 11:16:50 INFO - mozlog == 3.1 11:16:50 INFO - moznetwork == 0.27 11:16:50 INFO - mozprocess == 0.22 11:16:50 INFO - mozprofile == 0.28 11:16:50 INFO - mozrunner == 6.11 11:16:50 INFO - mozscreenshot == 0.1 11:16:50 INFO - mozsystemmonitor == 0.0 11:16:50 INFO - moztest == 0.7 11:16:50 INFO - mozversion == 1.4 11:16:50 INFO - psutil == 3.1.1 11:16:50 INFO - requests == 1.2.3 11:16:50 INFO - wsgiref == 0.1.2 11:16:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:16:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:50 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 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16:50 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 11:16:50 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 11:16:50 INFO - Using env: {'DISPLAY': ':0', 11:16:50 INFO - 'HOME': '/home/cltbld', 11:16:50 INFO - 'LANG': 'en_US.UTF-8', 11:16:50 INFO - 'LANGUAGE': 'en_US:en', 11:16:50 INFO - 'LOGNAME': 'cltbld', 11:16:50 INFO - 'MAIL': '/var/mail/cltbld', 11:16:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:50 INFO - 'MOZ_NO_REMOTE': '1', 11:16:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:50 INFO - 'NO_EM_RESTART': '1', 11:16:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:50 INFO - 'PWD': '/builds/slave/test', 11:16:50 INFO - 'SHELL': '/bin/bash', 11:16:50 INFO - 'SHLVL': '1', 11:16:50 INFO - 'TERM': 'linux', 11:16:50 INFO - 'TMOUT': '86400', 11:16:50 INFO - 'USER': 'cltbld', 11:16:50 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:50 INFO - '_': '/tools/buildbot/bin/python'} 11:16:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 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)) 11:16:51 INFO - Cleaning up... 11:16:51 INFO - Return code: 0 11:16:51 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16: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', 'jsonschema'] in /builds/slave/test/build 11:16: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 jsonschema 11:16:51 INFO - Using env: {'DISPLAY': ':0', 11:16:51 INFO - 'HOME': '/home/cltbld', 11:16:51 INFO - 'LANG': 'en_US.UTF-8', 11:16:51 INFO - 'LANGUAGE': 'en_US:en', 11:16:51 INFO - 'LOGNAME': 'cltbld', 11:16:51 INFO - 'MAIL': '/var/mail/cltbld', 11:16:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:51 INFO - 'MOZ_NO_REMOTE': '1', 11:16:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:51 INFO - 'NO_EM_RESTART': '1', 11:16:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:51 INFO - 'PWD': '/builds/slave/test', 11:16:51 INFO - 'SHELL': '/bin/bash', 11:16:51 INFO - 'SHLVL': '1', 11:16:51 INFO - 'TERM': 'linux', 11:16:51 INFO - 'TMOUT': '86400', 11:16:51 INFO - 'USER': 'cltbld', 11:16:51 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:51 INFO - '_': '/tools/buildbot/bin/python'} 11:16:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:51 INFO - Downloading/unpacking jsonschema 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16:53 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:16:53 INFO - Downloading/unpacking functools32 (from jsonschema) 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16:53 INFO - Downloading functools32-3.2.3-2.tar.gz 11:16:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:16:53 INFO - warning: no files found matching '*.txt' 11:16:53 INFO - no previously-included directories found matching 'build' 11:16:53 INFO - no previously-included directories found matching 'dist' 11:16:53 INFO - no previously-included directories found matching '.git*' 11:16:53 INFO - Installing collected packages: jsonschema, functools32 11:16:53 INFO - Running setup.py install for functools32 11:16:53 INFO - warning: no files found matching '*.txt' 11:16:53 INFO - no previously-included directories found matching 'build' 11:16:53 INFO - no previously-included directories found matching 'dist' 11:16:53 INFO - no previously-included directories found matching '.git*' 11:16:53 INFO - Successfully installed jsonschema functools32 11:16:53 INFO - Cleaning up... 11:16:53 INFO - Return code: 0 11:16:53 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 11:16:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:16:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:16:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:16:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:16:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fad481b2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29138a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29de5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', '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 11:16:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 11:16:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 11:16:53 INFO - Using env: {'DISPLAY': ':0', 11:16:53 INFO - 'HOME': '/home/cltbld', 11:16:53 INFO - 'LANG': 'en_US.UTF-8', 11:16:53 INFO - 'LANGUAGE': 'en_US:en', 11:16:53 INFO - 'LOGNAME': 'cltbld', 11:16:53 INFO - 'MAIL': '/var/mail/cltbld', 11:16:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:16:53 INFO - 'MOZ_NO_REMOTE': '1', 11:16:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:16:53 INFO - 'NO_EM_RESTART': '1', 11:16:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:16:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:16:53 INFO - 'PWD': '/builds/slave/test', 11:16:53 INFO - 'SHELL': '/bin/bash', 11:16:53 INFO - 'SHLVL': '1', 11:16:53 INFO - 'TERM': 'linux', 11:16:53 INFO - 'TMOUT': '86400', 11:16:53 INFO - 'USER': 'cltbld', 11:16:53 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:16:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:16:53 INFO - '_': '/tools/buildbot/bin/python'} 11:16:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:16:53 INFO - Downloading/unpacking flake8 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16: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 11:16:55 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 11:16:55 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 11:16:55 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 11:16:55 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 11:16:55 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 11:16:55 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 11:16:55 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 11:16:55 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 11:16:56 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 11:16:56 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 11:16:56 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 11:16:56 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 11:16:56 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 11:16:56 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 11:16:56 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 11:16:56 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 11:16:56 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 11:16:56 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 11:16:56 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 11:16:56 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 11:16:56 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 11:16:56 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 11:16:56 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 11:16:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 11:16:56 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:16:56 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:16:56 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:16:56 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:16:56 INFO - no previously-included directories found matching 'docs/_build' 11:16:56 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 11:16:56 INFO - Running setup.py install for pep8 11:16:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:16:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:16:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:16:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:16:57 INFO - no previously-included directories found matching 'docs/_build' 11:16:57 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 11:16:57 INFO - Successfully installed flake8 mccabe pyflakes pep8 11:16:57 INFO - Cleaning up... 11:16:57 INFO - Return code: 0 11:16:57 INFO - Running post-action listener: _resource_record_post_action 11:16:57 INFO - Running post-action listener: _start_resource_monitoring 11:16:58 INFO - Starting resource monitoring. 11:16:58 INFO - ##### 11:16:58 INFO - ##### Running install step. 11:16:58 INFO - ##### 11:16:58 INFO - Running pre-action listener: _resource_record_pre_action 11:16:58 INFO - Running main action method: install 11:16:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:16:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:16:58 INFO - Reading from file tmpfile_stdout 11:16:58 INFO - Detecting whether we're running mozinstall >=1.0... 11:16:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:16:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:16:58 INFO - Reading from file tmpfile_stdout 11:16:58 INFO - Output received: 11:16:58 INFO - Usage: mozinstall [options] installer 11:16:58 INFO - Options: 11:16:58 INFO - -h, --help show this help message and exit 11:16:58 INFO - -d DEST, --destination=DEST 11:16:58 INFO - Directory to install application into. [default: 11:16:58 INFO - "/builds/slave/test"] 11:16:58 INFO - --app=APP Application being installed. [default: firefox] 11:16:58 INFO - mkdir: /builds/slave/test/build/application 11:16:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 11:16:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 11:17:14 INFO - Reading from file tmpfile_stdout 11:17:14 INFO - Output received: 11:17:14 INFO - /builds/slave/test/build/application/firefox/firefox 11:17:14 INFO - Running post-action listener: _resource_record_post_action 11:17:14 INFO - ##### 11:17:14 INFO - ##### Running run-tests step. 11:17:14 INFO - ##### 11:17:14 INFO - Running pre-action listener: _resource_record_pre_action 11:17:14 INFO - Running main action method: run_tests 11:17:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:17:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:17:14 INFO - Python 2.7.3 11:17:14 INFO - Return code: 0 11:17:14 INFO - grabbing minidump binary from tooltool 11:17:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:17:14 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a6d410>, '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 0x2a6e310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a6e7a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:17:14 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 11:17:14 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 11:17:14 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:17:14 INFO - Return code: 0 11:17:14 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:17:14 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:17:14 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:17:14 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:17:14 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:17:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 11:17:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 11:17:16 INFO - Return code: 0 11:17:16 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/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-064', '--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 11:17:16 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/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-064 --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 11:17:16 INFO - Using env: {'DISPLAY': ':0', 11:17:16 INFO - 'HOME': '/home/cltbld', 11:17:16 INFO - 'LANG': 'en_US.UTF-8', 11:17:16 INFO - 'LANGUAGE': 'en_US:en', 11:17:16 INFO - 'LOGNAME': 'cltbld', 11:17:16 INFO - 'MAIL': '/var/mail/cltbld', 11:17:16 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:17:16 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:17:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:17:16 INFO - 'MOZ_NO_REMOTE': '1', 11:17:16 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:17:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:17:16 INFO - 'NO_EM_RESTART': '1', 11:17:16 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:17:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:17:16 INFO - 'PWD': '/builds/slave/test', 11:17:16 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:17:16 INFO - 'SHELL': '/bin/bash', 11:17:16 INFO - 'SHLVL': '1', 11:17:16 INFO - 'TERM': 'linux', 11:17:16 INFO - 'TMOUT': '86400', 11:17:16 INFO - 'USER': 'cltbld', 11:17:16 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251', 11:17:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:17:16 INFO - '_': '/tools/buildbot/bin/python'} 11:17:16 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/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-064', '--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 11:17:16 INFO - mozversion application_buildid: 20160416083214 11:17:16 INFO - mozversion application_changeset: abe15212891c03d58bee30a6ec38e89bcb4abef3 11:17:16 INFO - mozversion application_display_name: Nightly 11:17:16 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:17:16 INFO - mozversion application_name: Firefox 11:17:16 INFO - mozversion application_remotingname: firefox 11:17:16 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:17:16 INFO - mozversion application_vendor: Mozilla 11:17:16 INFO - mozversion application_version: 48.0a1 11:17:16 INFO - mozversion platform_buildid: 20160416083214 11:17:16 INFO - mozversion platform_changeset: abe15212891c03d58bee30a6ec38e89bcb4abef3 11:17:16 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:17:16 INFO - mozversion platform_version: 48.0a1 11:17:16 INFO - using testdate: 1460830636 11:17:16 INFO - actual date: 1460830636 11:17:16 INFO - starting webserver on 'localhost:43986' 11:17:16 INFO - SUITE-START | Running 2 tests 11:17:16 INFO - TEST-START | dromaeo_css 11:17:16 INFO - operating with platform_type : linux_ 11:17:16 INFO - Initialising browser for dromaeo_css test... 11:17:16 INFO - TEST-INFO | started process 11375 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpoJ3kmi/profile http://localhost:43986/getInfo.html) 11:17:20 INFO - PROCESS | 11375 | 11:17:20 INFO - PROCESS | 11375 | (process:11444): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 11:17:20 INFO - PROCESS | 11375 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 11:17:20 INFO - PROCESS | 11375 | __metrics Screen width/height:1600/1200 11:17:20 INFO - PROCESS | 11375 | colorDepth:24 11:17:20 INFO - PROCESS | 11375 | Browser inner width/height: 1024/697 11:17:20 INFO - PROCESS | 11375 | __metrics 11:17:21 ERROR - PROCESS | 11375 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 11:17:22 INFO - TEST-INFO | 11375: exit 0 11:17:22 INFO - Browser initialized. 11:17:22 INFO - Running cycle 1/1 for dromaeo_css test... 11:17:22 INFO - TEST-INFO | started process 11495 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpoJ3kmi/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:17:24 INFO - PROCESS | 11495 | 11:17:24 INFO - PROCESS | 11495 | (process:11553): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 11:17:34 INFO - PROCESS | 11495 | RSS: Main: 163467264 11:17:34 INFO - PROCESS | 11495 | 11:18:23 INFO - PROCESS | 11495 | 1460830703962 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] 11:20:32 INFO - PROCESS | 11495 | Cycle 1(1): loaded http://localhost:43986/tests/dromaeo/cssquery-dojo.html (next: http://localhost:43986/tests/dromaeo/cssquery-ext.html) 11:20:33 INFO - PROCESS | 11495 | RSS: Main: 168464384 11:20:33 INFO - PROCESS | 11495 | 11:23:35 INFO - PROCESS | 11495 | Cycle 1(1): loaded http://localhost:43986/tests/dromaeo/cssquery-ext.html (next: http://localhost:43986/tests/dromaeo/cssquery-jquery.html) 11:23:35 INFO - PROCESS | 11495 | RSS: Main: 165519360 11:23:35 INFO - PROCESS | 11495 | 11:26:37 INFO - PROCESS | 11495 | Cycle 1(1): loaded http://localhost:43986/tests/dromaeo/cssquery-jquery.html (next: http://localhost:43986/tests/dromaeo/cssquery-mootools.html) 11:26:38 INFO - PROCESS | 11495 | RSS: Main: 166166528 11:26:38 INFO - PROCESS | 11495 | 11:29:39 INFO - PROCESS | 11495 | Cycle 1(1): loaded http://localhost:43986/tests/dromaeo/cssquery-mootools.html (next: http://localhost:43986/tests/dromaeo/cssquery-prototype.html) 11:29:40 INFO - PROCESS | 11495 | RSS: Main: 163975168 11:29:40 INFO - PROCESS | 11495 | 11:32:42 INFO - PROCESS | 11495 | Cycle 1(1): loaded http://localhost:43986/tests/dromaeo/cssquery-prototype.html (next: http://localhost:43986/tests/dromaeo/cssquery-yui.html) 11:32:43 INFO - PROCESS | 11495 | RSS: Main: 165535744 11:32:43 INFO - PROCESS | 11495 | 11:35:45 INFO - PROCESS | 11495 | Cycle 1(1): loaded http://localhost:43986/tests/dromaeo/cssquery-yui.html (next: http://localhost:43986/tests/dromaeo/cssquery-dojo.html) 11:35:46 INFO - PROCESS | 11495 | RSS: Main: 167170048 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - PROCESS | 11495 | __start_tp_report 11:35:46 INFO - PROCESS | 11495 | _x_x_mozilla_page_load 11:35:46 INFO - PROCESS | 11495 | _x_x_mozilla_page_load_details 11:35:46 INFO - PROCESS | 11495 | |i|pagename|runs| 11:35:46 INFO - PROCESS | 11495 | |0;dojo.html;3084.3985422842543;3102.0693791862436;3157.0371036833785;3166.9366612667745;3189.553462515248;5416.106342453495;5417.3770016448125;5426.9185962210595;5437.048516509615;5456.945430545693;5373.570114390849;5487.972560137204;5567.47109024643;5572.7770889164485;5586.776528938837;4919.0899683558655;4923;4952.405711314647;5099.745012749348;5121.3342265505435;5038.017586570621;5051.090803655341;5080.390353157626;5087.236914462823;5097.5667068299235;4930.926036109461;4953.578945789613;4988.176950803113;5039.168537191359;5048.621353398473;4935.358403407534;4936.777844996948;4937.925931111036;4971;4990.451050384455;4878.414590249157;4929.433115191763;4932.753362331869;4948.331975183376;4973.055119527315;5377.784888604451;5418.2685337479725;5441.29263195786;5446.183072539151;5468.0977638689565;5820.650760954314;5836.708164591753;5870.236869206976;5879.882402351972;5901.557383196235;5748.655080695172;5882.794102206445;5906.23218981534;5906.645601263938;5918.852028699274;5488.341399032101;5502.614816962814;5509.173623956439;5525.834224973257;5573.526250268732;6030.27636683592;6031.065184896348;6033.396660333931;6043.425874541911;6049.848753781191;5628.634138780966;5713.200151978726;5797.536197104221;5801.390853960358;5814.912776308359;5764.423557644286;5889.263842019747;5889.499392551681;5889.941100589025;5926.970365148147;5825.2135961644635;5832.9708351457975;5855.619384739978;5861.856937897154;5938.6436813791315;5694.5159661428415;5801.94198058014;5826.592138550261;5878.794242201502;5889.528837692974;4418.469783625921;4442.68901176921;4442.755648439303;4458.264386376277;4483.08096840147;3937.2716047530726;3943.7042221833476;3947.486826712509;4018.3369743991916;4034.072163402434;5550.58370622205;5597.692126933058;5624.887502249932;5642.210090587321;5657.830265092054;5942.61373010753;5945.881082378415;5948.226730525091;5952.821415357546;5976.820695379059;5559.082751346064;5591.720413979366;5612.691301978431;5624.91562626561;5638.577106716931;4822.903541929142;4864.951350486521;4900.436449808247;4909.729964851896;4937.7777999990085;6072.574919755575;6076.848078798065;6089.269287685506;6110.022396416552;6122.357152499013;5758.280214973129;5869.06095024794;5890.204822348928;5896.64620122794;5915.024021036566;6092.960776441158;6179.3202747698615;6182.938170618416;6204.038374052029;6209.65846878408;5699.9145012825675;5731.054376028075;5735.770569177186;5744.971275143765;5773.653580785166;5709.314882214161;5814.76740930358;5825.592208545361;5836.328822185334;5878.118282257696;5667.631603945731;5736.110902810071;5763.049096898964;5814.244148260868;5825.854353641193;5722.3991480895575;5759.827205183851;5764.337101233412;5776.682282474504;5781.624194427349;5470.972645136749;5632.971835140798;5645.576581756467;5678.574106942078;5690.601657883908;5741.684207368635;5769.134629805562;5805.593608447537;5806.564507662027;5826.7086645666695;5644.520215781705;5652;5685.857853553694;5686.488216060575;5687.317521897398 11:35:46 INFO - PROCESS | 11495 | |1;ext.html;587.3979171349366;620.0265583034635;636.6402982314993;640.1645852162932;644.5327137825075;37736.245275094516;38260.99999999996;38283.80858095713;38369;38408.23183536327;41157.58842411575;41510.58489415105;41689.16621667565;41772.791136044354;41906.37140442896;8544.18830211129;8671.869921951176;8707.47755134694;8731.563421828883;8731.738047858575;8416.284615807665;8610.052894181636;8650.783730406727;8805.823883522326;8820.426672266281;8763.079876612928;8813.823723525558;8839.60221790021;8877;8903.332250081237;8776.122387761205;8788.033316335199;8797.736067917973;8799.736007919773;8845.159709827556;8713.390062695615;8812.691555795516;8827.646894124227;8855.114488551159;8858.86711699325;40882.59117408818;41197.176056478704;41273;41401;41663.7916810414;2957.6746557878614;3375.6961873431264;3536.522569453117;3909.7263191576603;4247.469066366704;27720.861395692893;28189.57715634267;28333.858330708215;28477.857610711813;29029.56455653167;4233.322668373045;4278.465191851019;4308.590683885026;4334.393184954109;4369.759663218521;258250;260036;260392;263094.68452657806;263581;36451;37747;60472.697636512414;61345;61357;35220.29559408798;35659.10852228715;35752;35776.821115894774;35850.46224306637;14888;15102.54692359231;15152.242387880562;15170.469033583771;15246.847531524543;12804.80792788109;12837.101402901893;12842.743145137045;12881.484740610458;12898.161619494704;8641.524716140673;8692.434991725517;8745.387822852466;8759.474431534129;8775.561221938877;3281.786683865541;3334.3664703706218;3412.931741365159;3417.6924076832706;3423.863045478203;1032.2774058159318;1049.2268066966801;1133.2520536445907;1167.9474423650956;1214.987850121505;31455.21361965969;32355.35289294201;32507.18732031718;33155;33368.33263334768;1095.802755504001;1098.4782228441427;1154.3650991954391;1155.2317708723604;1176.2295696318924;17069;17195.656086878444;17433.21550530229;17496.562585935455;17556.912215439097;430224;434595;434906;436828;438167;56734;57408.42591574114;57448.42551574514;57458.13812792811;57513.99999999916;1307.666545031011;1332.4470344806796;1336.1181620130667;1362.7410791949499;1382.410228237535;31066.378672425973;31410.371792563565;31427.528587070756;31540.52689209618;31870;49902.251466228765;54978.45021549733;57082.7145864268;57191.42808571861;57285.71357143188;406318;409433;412606;413252;413686;43863;44078.779606101765;44640.77679611581;44851.775741121084;45016;47484.2877356833;47747.5225247757;47982;48147.27779083387;48758.75620621874;40145;40798.388024180254;40940.79529602333;41010;42070.15859682851;39085.804570976965;39505.604943950195;39778.60221397865;40695.59304407037;41433.37849932314;39892.800535997136;40607.39088913728;40933.590664092975;42450.78774606107;42542.5745742551;37522.624773751915;38909.221815564095;39030.2193956125;39042.414363783995;39663.40504892371;30354.241143970696;30636.846815765777;30993.380132397677;31428;31596.684033159374 11:35:46 INFO - PROCESS | 11495 | |2;jquery.html;387.1386165781137;394.7473616885192;401.44800898764197;404.3853342918763;406.30116200135757;13830.515931942384;15237;17601.559961000967;18502.722459163124;18509.074546272685;11504.769904601902;11856.170068095236;17310.307587696476;17630.206640701166;17647;4802.639802014845;4902.852914412556;4930.063287975291;4945.208766597345;5015.473375295578;5004.199328107504;5166.483351664841;5289.8942021159555;5297.046531624306;5299.867503312429;5263.31576895005;5272.367315922094;5278.736063196825;5288.233206185101;5305.204219367107;5152.716600586966;5164.070467315882;5171.17261238202;5178.559822415099;5260.973695131538;4963.826266080706;5017.54842064216;5097.541221290065;5108.770105345268;5110.8466745997675;12934;14117.78823317651;22049.22827701023;22497.662535061987;22537.211197608005;2215.501512159751;2282.7945484906436;2319.0607803839303;2362.681038059857;2740.780737540992;9649.807003859954;9782.070703283176;12015.939920300343;13060.281684507348;13459.528916487974;1871.9157637906192;1886.3303527247767;1917.5844573691375;1986.2750096214922;2017.7679566849706;57778.7111064442;72788.6360568199;76084.23915760883;77179.61410192912;77978;9045.683401081062;9773.706788796348;9862.50687465624;10247.692569222936;10643.627473038407;13137.080404371602;13199;13285.933570332087;13291.601251962456;13296.069275150647;7847.1368149503505;7868.72459463916;7909.5649739263745;7989.760307190793;8085.514869107872;7826.647800848976;7897.1707970662255;7898.091719452336;8096.595170241464;8119.741440076679;4026.9452927405405;4038.172174704179;4112.115895082572;4172.311568591209;4192.622663960258;1919.9424017279505;1969.2713695932596;1974.9703754443694;1998.9900050499655;2022.5752591955854;919.5769945824861;980.8773903262093;1011.4184344002228;1030.721705139608;1051.7686109055996;18961.90519047396;19058.714119288223;19070.809291907182;19167.80832191688;19497;970.5244430229137;1040.625374865048;1061.713337398898;1064.446487826326;1126.0766171739258;10412.895871041193;10783.730406739738;10956.945215273872;10962.013418792347;10976.451177441097;468777;469936;470307;476373;492726;79645.60177199077;84786.5760671205;85540.57229713812;86757;87852;1067.1942683274233;1070.3310430980637;1077.7575045614674;1078.5254488025087;1085.6580177244143;16645.334186632885;16856.325746969986;16883.32466701318;16992.57518562046;17086.40197593078;37485;38799.22401552009;38934;39391.40912886251;39902.201955961296;51959.74020129875;54971.175432369346;55206.44793552174;55431.722841385534;55635.72182139225;7556.357709594746;7832;8023.077346105039;8230.300424463987;8815.294776417742;9362.344635875423;12991.870081299066;13017.544385946447;13037.15258508194;13237.338133093499;11363.431828408382;11514.42427878586;11721;11930.582429614922;11970.640880773592;6036.63780173191;10943.671689849318;11756.295337176232;11826.586069487526;12156.452959616661;11540.653780386601;11970.521179152736;12022.098342624164;12048.216865903689;12321.568745094237;8120.066192387951;8135.511869287861;8148.511089334659;8162.795930101795;8195.71315003996;11390.37352945596;11410.714732131431;11476.598319058792;11745.354005529778;11783.52865885355 11:35:46 INFO - PROCESS | 11495 | |3;mootools.html;1511.7505611574095;1521.946731864385;1663.5508412728564;1745.3891138101658;1756.2448147296666;7656.961715191416;8199.754007379774;8265.83468330633;8563.828723425528;8577.785555361112;8240.423170378075;8287.088420273765;8331.666733330674;8352.540610266433;8362.205590468911;2210.8120809731154;2251.1558165687866;2251.2120757734824;2256.2328808205207;2264.524449865522;2194.319760874126;2207.172310383606;2215.313252891609;2227.064632854197;2228.9108435662556;2163;2170.0451801207496;2173.7065496157975;2176.1295481807324;2209.3371988403496;2159.8704077755306;2165.1664109317867;2171.6416791229426;2177.640689286266;2179.411558879102;2156.2884248198056;2172.076867331378;2188.9233876814237;2196.703445034932;2201.8238540916686;8442.409031367806;8542.78643033929;8557;8576.914230857674;8597.699080532151;4926.1379258629595;5075.796968121308;5097.8215762448135;5097.923531147036;5117.437081920985;3200;3247.9837600811843;3344.966550334514;3370.882019129319;3390.593128824532;1040.2458217792116;1060.2419270221828;1068.722132245614;1072.3351522056375;1123.9213255072148;11618.883811161864;11633.53465861356;11748.941255293754;11795.410229488578;11877.16859819813;4345.9348109778375;4439.511653718088;4609.078184363074;4651.465081515601;4653.302004699322;10075.697729068139;10087.798244035079;10089.545970431202;10089.899101008896;10103.393796372242;5107.157319042391;5109.489051094861;5112.6421150519855;5123.462036486116;5132.794688212504;4269.210196113729;4625.121226966866;4648.558386953234;4680.625549955996;4725.763711814396;3867.61323867611;3867.7485963412287;3957.762534247954;3965.0087478130467;3983.880483585497;1266.8226448297246;1280.3470230182488;1285.2609749394135;1297;1299.6101169649066;775;908.68650315641;946.3753922411175;967.8209531236744;979.3487330924997;5920.2007728956905;6017.187679663277;6026.728797204137;6134.5092392608485;6147.139400483936;441.90719948810465;446.5043801380465;460.3876843797808;463.80288377439456;464.6584760201317;4073.3075377185355;4078.7552746835286;4081.775502347399;4100.323446631332;4120.711550191518;10206.438645874548;10623.681289561326;10701;10709.143268538499;10715.19636027301;10622.46887655614;10630;10634.361938283728;10659.14726821868;10681.946590266998;8018;8037.196280372033;8138.145494722969;8144.633491492897;8154.633041513146;5738.282714660668;5744.569157313134;5763.6541807491685;5823.272090988627;5871.324797648154;9653.71038868807;9670.75823104428;9841;9893.505324733878;9910.454924978907;9808.65669701557;9989.350692204984;10068.144207742424;10070.647527336509;10178;6745.561538499982;7305.561666300039;7562.470627056054;7586.393088553013;7633.274838890296;8418.705345312885;8480.10958849312;8485.151484851713;8512.914870851213;8538.743837684879;7540.924590754023;7769.572673503011;7794.532328060334;7857;7864.764057078297;7565.735199268;7571.432142589438;7577.431692623186;7665.961670191613;7686.8078298040755;6995.440364770908;7025.437964962893;7036.437085033082;7046.612436316052;7093.858122837411;4928.211486162197;4936.7284799336385;5048.141815891234;5122.615803814803;5127.179651255781;5114.539691427789;5136.486351364983;5148.613853961043;5191.402988656353;5321.733913304397 11:35:46 INFO - PROCESS | 11495 | |4;prototype.html;312.7419878600154;318.93780712761014;320.3416978109983;324.1652744183727;327.73289768838396;5855.151003104547;5886;6042.728077236524;6162.352952939944;6167.136600875881;5973.880522389561;5974;5979.970100149493;6024.186734790802;6028.909566356509;4541.250693635563;4545.36364908913;4553.248713962193;4556.521565235652;4562.726236425809;4436.822527098912;4539.704919180259;4573.634109271267;4577.954220457803;4578.519255478177;4497.482789479219;4502.662300327472;4504.346869703891;4533.365328853963;4536.637069034486;4508.436445444319;4541.523140070294;4555.74943378114;4556.407667003285;4557.521460246693;3879.497723968053;3943.684505239574;3988.900277493057;3999.9400008999887;4002.2195671844;5729.627574207705;5736.426357364272;5763.337216220105;5766.625169363978;5782.479576838105;5218.8695282617855;5230.660007099526;5245;5248.186531087649;5249.895002099975;5973.492253158487;6215.658138802364;6225.346338634468;6232.594881332699;6244.906326405107;4334.154839806239;4352.238358287287;4354.869353919387;4363.214621368153;4369.082492676542;6288.434040936292;6593.472522198213;6599.505037122235;6601.438877695402;6609.966950165219;4468.642508599304;4470.150671372428;4483.843065492692;4487.922898504401;4488.4613846338;4515.909681806345;4528.9094218116115;4532.501424843264;4542.364069030338;4546.340780586863;5166.147585648326;5174.818881339135;5207.843764687065;5214.817481388133;5216.747980484733;5960.37416071315;6104.755809767559;6303.590266632654;6310.211223597051;6318.462930650946;1578.9605259868595;1617.2156504095503;1619.667968066567;1624.4395683489413;1627.4629372307347;1053.5522402978856;1069.5667805141147;1073.8013467508379;1079.1474734959452;1082.1667316166508;6052.54871776931;6056.152138700585;6073.967425537669;6082.1789058477425;6101.511879049665;6410.294867564564;6443.29123796382;6453.515986301046;6492.513061520405;6565.868682626321;5862.508433915569;6044.788432404933;6054.243219597551;6095.817125486243;6129.11127886454;3485.8779942701885;3495.5106285120105;3517.806520641338;3536.45184996326;3554.306910152547;6581.86836263272;6690.966545167243;6718.328167183243;6719.630420326929;6788.185417749902;6673.599584024974;6674.199096108498;6688.732450702015;6691.26396096429;6697.22981857083;6610.900836487456;6796.184457865088;6805.455563555002;6832.795016149524;6846.520743548003;6500.934990650222;6527.412532872065;6529.183852018497;6535.803925882231;6544.9672751637845;6311.968440157953;6485.416312531895;6504;6515.511336649865;6532.203643997938;6818.420434262945;6831;6841.555298905555;6847.6576171190245;6848.7260509579055;4507.3689683445;4552.271636538138;4552.544745525421;4557.361969324231;4615.14619795339;6200.193974783429;6424.164858568356;6528.543001989815;6562.818692635372;6612.636305003271;6347.809565713036;6386.489080873612;6386.776462823779;6415.967920160556;6418.6469744164515;6164.291106522807;6338.397852204033;6363.96818015907;6373.490120790419;6408.58344207625;6263.279722831932;6272.686365681789;6276.121343012073;6307.148534947723;6310.747570097328;6345.302016778059;6374.58565193261;6420.518461115342;6422.036694495863;6429.51778616615;5995.520358371407;6293.244810622571;6305.684715764285;6311.400416960381;6318.778842740482 11:35:46 INFO - PROCESS | 11495 | |5;yui.html;763.4651563262096;798.872180451128;802.5826570183508;803.9196080391962;812.528733334666;12195.390230488474;12221.816672749916;12415.8892988192;12490.250584964908;12523.624291271264;12303.32331721755;12479.064070194727;12674;12681;12683.809742853842;771.8301973565807;792.4373694676772;799.0571126071262;802.2739420824164;815.6696537902159;793.9603019848985;796.4385108498494;798.6206551887865;801.418971245848;803.5058439059994;839.4669384940577;850.3962186847345;853.1937319233327;853.4282031039219;854.406187699549;842.0653075086649;843.9957800211021;844.2950136635916;845.2266176448542;848.7284069097922;611.5382885921146;613.1446631948452;620.3517324395972;623.1338439569003;626.0234034905562;12946.611601651966;12996.935015324958;13006.544770933067;13046.086773925828;13074.738505229938;12931.935340323238;13013.219206847525;13312;13346;13503;11273.943630281878;11672.766544669144;11727.589534366341;11734.178607497479;11926.105542084379;3782.9054273643105;3794.696424286078;3845.942310865339;3927.7839718815453;3942.4086387041884;57795.42204577942;58027;59444.40555594432;59517.40482595205;59984.400155998315;10471.94764026175;10937.781244375068;11084.168687348481;11167.776644467065;11407.600733974272;19390.4182874514;19410.514737131685;19421.805781942;19447.805521944883;19488;7841.725539606086;7901.407394445439;7991.880121798177;8036.919630803734;8277.130901255401;4727.881802954885;4753;4797.976010119997;4851.078295123915;4909.705417674951;3190.409774191782;3261.559689441895;3291.2759192977987;3301.042697617712;3312.6521715220038;581.6121094623833;583.5681595619296;585.871108356161;592.120700759372;593.2613895699795;608.6753615561373;710.8365076032542;724.4349407462188;731.2102928836844;738.837455759732;8732.8690069649;8751.168638979287;8871.290296776242;8964.820703585892;9073.682421115229;565.7623798004848;577.4168090228815;656.0323522803826;677.529117263507;722.0613202836291;3954.2486927483687;4055.2903241932545;4103.425520427142;4112.218678451085;4206.26390381682;63086.684566577795;65011.67494162499;65283.34716652868;65422.34577654258;66185.33814661889;56430.43569564334;56566.43433565694;56712;56859.43140568541;57413.42586574164;47743.76128119337;48411.5158848407;48804.755976219894;49475.50524494709;49488.25767613489;8047.315978141924;8104.230098140667;8250.174982501701;8251.2986396157;8420.4947703138;34082.31835363329;34866.30267394587;35136.64863351436;35766;35911.82044089763;47503.762481187376;49583.256251156985;51437.7428112857;51616.74191629168;51721.482785173175;12131.272123672608;12295.44670489848;12395.070369722487;12483.500659973863;12580.559680411141;11302.604408845651;12891.806622900851;13179.60461186166;13704.451821927012;14073;11474.426278685865;11551.422428878355;11802.881971180179;11817.586384476503;11851.644450666494;12080;12720.6819829505;12742.68143296425;12780.1053926228;12926.935365323114;11660.125490588409;11771.352575608424;12015.939920300343;12260.203086799329;12622.242665440102;8477.660893564189;10028.849567256351;10320.380777153396;10426.165906727596;10648.84026739584;11057.72355691082;11084.667459976214;11152.735736905946;11275.492602832728;11363.943180284046 11:35:46 INFO - PROCESS | 11495 | __end_tp_report 11:35:46 INFO - PROCESS | 11495 | __start_cc_report 11:35:46 INFO - PROCESS | 11495 | _x_x_mozilla_cycle_collect,330 11:35:46 INFO - PROCESS | 11495 | __end_cc_report 11:35:46 INFO - PROCESS | 11495 | __startTimestamp1460831746100__endTimestamp 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - PROCESS | 11495 | ------- Summary: start ------- 11:35:46 INFO - PROCESS | 11495 | Number of tests: 6 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - PROCESS | 11495 | [#0] dojo.html Cycles:165 Average:5449.84 Median:5678.57 stddev:635.79 (11.2%) stddev-sans-first:610.06 11:35:46 INFO - PROCESS | 11495 | Values: 3084.4 3102.1 3157.0 3166.9 3189.6 5416.1 5417.4 5426.9 5437.0 5456.9 5373.6 5488.0 5567.5 5572.8 5586.8 4919.1 4923.0 4952.4 5099.7 5121.3 5038.0 5051.1 5080.4 5087.2 5097.6 4930.9 4953.6 4988.2 5039.2 5048.6 4935.4 4936.8 4937.9 4971.0 4990.5 4878.4 4929.4 4932.8 4948.3 4973.1 5377.8 5418.3 5441.3 5446.2 5468.1 5820.7 5836.7 5870.2 5879.9 5901.6 5748.7 5882.8 5906.2 5906.6 5918.9 5488.3 5502.6 5509.2 5525.8 5573.5 6030.3 6031.1 6033.4 6043.4 6049.8 5628.6 5713.2 5797.5 5801.4 5814.9 5764.4 5889.3 5889.5 5889.9 5927.0 5825.2 5833.0 5855.6 5861.9 5938.6 5694.5 5801.9 5826.6 5878.8 5889.5 4418.5 4442.7 4442.8 4458.3 4483.1 3937.3 3943.7 3947.5 4018.3 4034.1 5550.6 5597.7 5624.9 5642.2 5657.8 5942.6 5945.9 5948.2 5952.8 5976.8 5559.1 5591.7 5612.7 5624.9 5638.6 4822.9 4865.0 4900.4 4909.7 4937.8 6072.6 6076.8 6089.3 6110.0 6122.4 5758.3 5869.1 5890.2 5896.6 5915.0 6093.0 6179.3 6182.9 6204.0 6209.7 5699.9 5731.1 5735.8 5745.0 5773.7 5709.3 5814.8 5825.6 5836.3 5878.1 5667.6 5736.1 5763.0 5814.2 5825.9 5722.4 5759.8 5764.3 5776.7 5781.6 5471.0 5633.0 5645.6 5678.6 5690.6 5741.7 5769.1 5805.6 5806.6 5826.7 5644.5 5652.0 5685.9 5686.5 5687.3 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - PROCESS | 11495 | [#1] ext.html Cycles:180 Average:53287.57 Median:40908.09 stddev:99609.70 (243.5%) stddev-sans-first:99810.54 11:35:46 INFO - PROCESS | 11495 | Values: 587.4 620.0 636.6 640.2 644.5 37736.2 38261.0 38283.8 38369.0 38408.2 41157.6 41510.6 41689.2 41772.8 41906.4 8544.2 8671.9 8707.5 8731.6 8731.7 8416.3 8610.1 8650.8 8805.8 8820.4 8763.1 8813.8 8839.6 8877.0 8903.3 8776.1 8788.0 8797.7 8799.7 8845.2 8713.4 8812.7 8827.6 8855.1 8858.9 40882.6 41197.2 41273.0 41401.0 41663.8 2957.7 3375.7 3536.5 3909.7 4247.5 27720.9 28189.6 28333.9 28477.9 29029.6 4233.3 4278.5 4308.6 4334.4 4369.8 258250.0 260036.0 260392.0 263094.7 263581.0 36451.0 37747.0 60472.7 61345.0 61357.0 35220.3 35659.1 35752.0 35776.8 35850.5 14888.0 15102.5 15152.2 15170.5 15246.8 12804.8 12837.1 12842.7 12881.5 12898.2 8641.5 8692.4 8745.4 8759.5 8775.6 3281.8 3334.4 3412.9 3417.7 3423.9 1032.3 1049.2 1133.3 1167.9 1215.0 31455.2 32355.4 32507.2 33155.0 33368.3 1095.8 1098.5 1154.4 1155.2 1176.2 17069.0 17195.7 17433.2 17496.6 17556.9 430224.0 434595.0 434906.0 436828.0 438167.0 56734.0 57408.4 57448.4 57458.1 57514.0 1307.7 1332.4 1336.1 1362.7 1382.4 31066.4 31410.4 31427.5 31540.5 31870.0 49902.3 54978.5 57082.7 57191.4 57285.7 406318.0 409433.0 412606.0 413252.0 413686.0 43863.0 44078.8 44640.8 44851.8 45016.0 47484.3 47747.5 47982.0 48147.3 48758.8 40145.0 40798.4 40940.8 41010.0 42070.2 39085.8 39505.6 39778.6 40695.6 41433.4 39892.8 40607.4 40933.6 42450.8 42542.6 37522.6 38909.2 39030.2 39042.4 39663.4 30354.2 30636.8 30993.4 31428.0 31596.7 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - PROCESS | 11495 | [#2] jquery.html Cycles:180 Average:27462.98 Median:18936.07 stddev:78274.76 (413.4%) stddev-sans-first:78467.94 11:35:46 INFO - PROCESS | 11495 | Values: 387.1 394.7 401.4 404.4 406.3 13830.5 15237.0 17601.6 18502.7 18509.1 11504.8 11856.2 17310.3 17630.2 17647.0 4802.6 4902.9 4930.1 4945.2 5015.5 5004.2 5166.5 5289.9 5297.0 5299.9 5263.3 5272.4 5278.7 5288.2 5305.2 5152.7 5164.1 5171.2 5178.6 5261.0 4963.8 5017.5 5097.5 5108.8 5110.8 12934.0 14117.8 22049.2 22497.7 22537.2 2215.5 2282.8 2319.1 2362.7 2740.8 9649.8 9782.1 12015.9 13060.3 13459.5 1871.9 1886.3 1917.6 1986.3 2017.8 57778.7 72788.6 76084.2 77179.6 77978.0 9045.7 9773.7 9862.5 10247.7 10643.6 13137.1 13199.0 13285.9 13291.6 13296.1 7847.1 7868.7 7909.6 7989.8 8085.5 7826.6 7897.2 7898.1 8096.6 8119.7 4026.9 4038.2 4112.1 4172.3 4192.6 1919.9 1969.3 1975.0 1999.0 2022.6 919.6 980.9 1011.4 1030.7 1051.8 18961.9 19058.7 19070.8 19167.8 19497.0 970.5 1040.6 1061.7 1064.4 1126.1 10412.9 10783.7 10956.9 10962.0 10976.5 468777.0 469936.0 470307.0 476373.0 492726.0 79645.6 84786.6 85540.6 86757.0 87852.0 1067.2 1070.3 1077.8 1078.5 1085.7 16645.3 16856.3 16883.3 16992.6 17086.4 37485.0 38799.2 38934.0 39391.4 39902.2 51959.7 54971.2 55206.4 55431.7 55635.7 7556.4 7832.0 8023.1 8230.3 8815.3 9362.3 12991.9 13017.5 13037.2 13237.3 11363.4 11514.4 11721.0 11930.6 11970.6 6036.6 10943.7 11756.3 11826.6 12156.5 11540.7 11970.5 12022.1 12048.2 12321.6 8120.1 8135.5 8148.5 8162.8 8195.7 11390.4 11410.7 11476.6 11745.4 11783.5 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - PROCESS | 11495 | [#3] mootools.html Cycles:180 Average:5650.42 Median:4666.96 stddev:3223.44 (69.1%) stddev-sans-first:3217.48 11:35:46 INFO - PROCESS | 11495 | Values: 1511.8 1521.9 1663.6 1745.4 1756.2 7657.0 8199.8 8265.8 8563.8 8577.8 8240.4 8287.1 8331.7 8352.5 8362.2 2210.8 2251.2 2251.2 2256.2 2264.5 2194.3 2207.2 2215.3 2227.1 2228.9 2163.0 2170.0 2173.7 2176.1 2209.3 2159.9 2165.2 2171.6 2177.6 2179.4 2156.3 2172.1 2188.9 2196.7 2201.8 8442.4 8542.8 8557.0 8576.9 8597.7 4926.1 5075.8 5097.8 5097.9 5117.4 3200.0 3248.0 3345.0 3370.9 3390.6 1040.2 1060.2 1068.7 1072.3 1123.9 11618.9 11633.5 11748.9 11795.4 11877.2 4345.9 4439.5 4609.1 4651.5 4653.3 10075.7 10087.8 10089.5 10089.9 10103.4 5107.2 5109.5 5112.6 5123.5 5132.8 4269.2 4625.1 4648.6 4680.6 4725.8 3867.6 3867.7 3957.8 3965.0 3983.9 1266.8 1280.3 1285.3 1297.0 1299.6 775.0 908.7 946.4 967.8 979.3 5920.2 6017.2 6026.7 6134.5 6147.1 441.9 446.5 460.4 463.8 464.7 4073.3 4078.8 4081.8 4100.3 4120.7 10206.4 10623.7 10701.0 10709.1 10715.2 10622.5 10630.0 10634.4 10659.1 10681.9 8018.0 8037.2 8138.1 8144.6 8154.6 5738.3 5744.6 5763.7 5823.3 5871.3 9653.7 9670.8 9841.0 9893.5 9910.5 9808.7 9989.4 10068.1 10070.6 10178.0 6745.6 7305.6 7562.5 7586.4 7633.3 8418.7 8480.1 8485.2 8512.9 8538.7 7540.9 7769.6 7794.5 7857.0 7864.8 7565.7 7571.4 7577.4 7666.0 7686.8 6995.4 7025.4 7036.4 7046.6 7093.9 4928.2 4936.7 5048.1 5122.6 5127.2 5114.5 5136.5 5148.6 5191.4 5321.7 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - PROCESS | 11495 | [#4] prototype.html Cycles:180 Average:5288.52 Median:6035.82 stddev:1596.50 (26.5%) stddev-sans-first:1556.68 11:35:46 INFO - PROCESS | 11495 | Values: 312.7 318.9 320.3 324.2 327.7 5855.2 5886.0 6042.7 6162.4 6167.1 5973.9 5974.0 5980.0 6024.2 6028.9 4541.3 4545.4 4553.2 4556.5 4562.7 4436.8 4539.7 4573.6 4578.0 4578.5 4497.5 4502.7 4504.3 4533.4 4536.6 4508.4 4541.5 4555.7 4556.4 4557.5 3879.5 3943.7 3988.9 3999.9 4002.2 5729.6 5736.4 5763.3 5766.6 5782.5 5218.9 5230.7 5245.0 5248.2 5249.9 5973.5 6215.7 6225.3 6232.6 6244.9 4334.2 4352.2 4354.9 4363.2 4369.1 6288.4 6593.5 6599.5 6601.4 6610.0 4468.6 4470.2 4483.8 4487.9 4488.5 4515.9 4528.9 4532.5 4542.4 4546.3 5166.1 5174.8 5207.8 5214.8 5216.7 5960.4 6104.8 6303.6 6310.2 6318.5 1579.0 1617.2 1619.7 1624.4 1627.5 1053.6 1069.6 1073.8 1079.1 1082.2 6052.5 6056.2 6074.0 6082.2 6101.5 6410.3 6443.3 6453.5 6492.5 6565.9 5862.5 6044.8 6054.2 6095.8 6129.1 3485.9 3495.5 3517.8 3536.5 3554.3 6581.9 6691.0 6718.3 6719.6 6788.2 6673.6 6674.2 6688.7 6691.3 6697.2 6610.9 6796.2 6805.5 6832.8 6846.5 6500.9 6527.4 6529.2 6535.8 6545.0 6312.0 6485.4 6504.0 6515.5 6532.2 6818.4 6831.0 6841.6 6847.7 6848.7 4507.4 4552.3 4552.5 4557.4 4615.1 6200.2 6424.2 6528.5 6562.8 6612.6 6347.8 6386.5 6386.8 6416.0 6418.6 6164.3 6338.4 6364.0 6373.5 6408.6 6263.3 6272.7 6276.1 6307.1 6310.7 6345.3 6374.6 6420.5 6422.0 6429.5 5995.5 6293.2 6305.7 6311.4 6318.8 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - PROCESS | 11495 | [#5] yui.html Cycles:180 Average:14974.79 Median:26128.38 stddev:17981.26 (68.8%) stddev-sans-first:18000.04 11:35:46 INFO - PROCESS | 11495 | Values: 763.5 798.9 802.6 803.9 812.5 12195.4 12221.8 12415.9 12490.3 12523.6 12303.3 12479.1 12674.0 12681.0 12683.8 771.8 792.4 799.1 802.3 815.7 794.0 796.4 798.6 801.4 803.5 839.5 850.4 853.2 853.4 854.4 842.1 844.0 844.3 845.2 848.7 611.5 613.1 620.4 623.1 626.0 12946.6 12996.9 13006.5 13046.1 13074.7 12931.9 13013.2 13312.0 13346.0 13503.0 11273.9 11672.8 11727.6 11734.2 11926.1 3782.9 3794.7 3845.9 3927.8 3942.4 57795.4 58027.0 59444.4 59517.4 59984.4 10471.9 10937.8 11084.2 11167.8 11407.6 19390.4 19410.5 19421.8 19447.8 19488.0 7841.7 7901.4 7991.9 8036.9 8277.1 4727.9 4753.0 4798.0 4851.1 4909.7 3190.4 3261.6 3291.3 3301.0 3312.7 581.6 583.6 585.9 592.1 593.3 608.7 710.8 724.4 731.2 738.8 8732.9 8751.2 8871.3 8964.8 9073.7 565.8 577.4 656.0 677.5 722.1 3954.2 4055.3 4103.4 4112.2 4206.3 63086.7 65011.7 65283.3 65422.3 66185.3 56430.4 56566.4 56712.0 56859.4 57413.4 47743.8 48411.5 48804.8 49475.5 49488.3 8047.3 8104.2 8250.2 8251.3 8420.5 34082.3 34866.3 35136.6 35766.0 35911.8 47503.8 49583.3 51437.7 51616.7 51721.5 12131.3 12295.4 12395.1 12483.5 12580.6 11302.6 12891.8 13179.6 13704.5 14073.0 11474.4 11551.4 11802.9 11817.6 11851.6 12080.0 12720.7 12742.7 12780.1 12926.9 11660.1 11771.4 12015.9 12260.2 12622.2 8477.7 10028.8 10320.4 10426.2 10648.8 11057.7 11084.7 11152.7 11275.5 11363.9 11:35:46 INFO - PROCESS | 11495 | -------- Summary: end -------- 11:35:46 INFO - PROCESS | 11495 | 11:35:46 INFO - TEST-INFO | 11495: exit 0 11:35:46 INFO - TEST-OK | dromaeo_css | took 1110609ms 11:35:46 INFO - TEST-START | kraken 11:35:46 INFO - operating with platform_type : linux_ 11:35:46 INFO - Initialising browser for kraken test... 11:35:46 INFO - TEST-INFO | started process 11726 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWlWFm3/profile http://localhost:43986/getInfo.html) 11:35:50 INFO - PROCESS | 11726 | 11:35:50 INFO - PROCESS | 11726 | (process:11795): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 11:35:50 INFO - PROCESS | 11726 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 11:35:51 INFO - PROCESS | 11726 | __metrics Screen width/height:1600/1200 11:35:51 INFO - PROCESS | 11726 | colorDepth:24 11:35:51 INFO - PROCESS | 11726 | Browser inner width/height: 1024/697 11:35:51 INFO - PROCESS | 11726 | __metrics 11:35:52 ERROR - PROCESS | 11726 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 11:35:52 INFO - TEST-INFO | 11726: exit 0 11:35:52 INFO - Browser initialized. 11:35:52 INFO - Running cycle 1/1 for kraken test... 11:35:52 INFO - TEST-INFO | started process 11846 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWlWFm3/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:35:54 INFO - PROCESS | 11846 | 11:35:54 INFO - PROCESS | 11846 | (process:11907): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 11:36:04 INFO - PROCESS | 11846 | RSS: Main: 163381248 11:36:04 INFO - PROCESS | 11846 | 11:36:07 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:43986/tests/kraken/driver.html?testName=audio-beat-detection) 11:36:08 INFO - PROCESS | 11846 | RSS: Main: 168042496 11:36:08 INFO - PROCESS | 11846 | 11:36:10 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:43986/tests/kraken/driver.html?testName=audio-dft) 11:36:11 INFO - PROCESS | 11846 | RSS: Main: 171622400 11:36:11 INFO - PROCESS | 11846 | 11:36:14 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:43986/tests/kraken/driver.html?testName=audio-fft) 11:36:14 INFO - PROCESS | 11846 | RSS: Main: 162836480 11:36:14 INFO - PROCESS | 11846 | 11:36:17 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:43986/tests/kraken/driver.html?testName=audio-oscillator) 11:36:17 INFO - PROCESS | 11846 | RSS: Main: 163307520 11:36:17 INFO - PROCESS | 11846 | 11:36:19 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:43986/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:36:20 INFO - PROCESS | 11846 | RSS: Main: 163610624 11:36:20 INFO - PROCESS | 11846 | 11:36:23 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:43986/tests/kraken/driver.html?testName=imaging-darkroom) 11:36:24 INFO - PROCESS | 11846 | RSS: Main: 164118528 11:36:24 INFO - PROCESS | 11846 | 11:36:27 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:43986/tests/kraken/driver.html?testName=imaging-desaturate) 11:36:28 INFO - PROCESS | 11846 | RSS: Main: 164093952 11:36:28 INFO - PROCESS | 11846 | 11:36:31 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:43986/tests/kraken/driver.html?testName=json-parse-financial) 11:36:31 INFO - PROCESS | 11846 | RSS: Main: 166383616 11:36:31 INFO - PROCESS | 11846 | 11:36:33 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:43986/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:36:33 INFO - PROCESS | 11846 | RSS: Main: 166227968 11:36:33 INFO - PROCESS | 11846 | 11:36:35 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:43986/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:36:36 INFO - PROCESS | 11846 | RSS: Main: 166281216 11:36:36 INFO - PROCESS | 11846 | 11:36:38 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:43986/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:36:38 INFO - PROCESS | 11846 | RSS: Main: 166895616 11:36:38 INFO - PROCESS | 11846 | 11:36:41 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:43986/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:36:42 INFO - PROCESS | 11846 | RSS: Main: 167628800 11:36:42 INFO - PROCESS | 11846 | 11:36:45 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:43986/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:36:45 INFO - PROCESS | 11846 | RSS: Main: 167243776 11:36:45 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | Cycle 1(1): loaded http://localhost:43986/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:43986/tests/kraken/driver.html?testName=ai-astar) 11:36:47 INFO - PROCESS | 11846 | RSS: Main: 168726528 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | __start_tp_report 11:36:47 INFO - PROCESS | 11846 | _x_x_mozilla_page_load 11:36:47 INFO - PROCESS | 11846 | _x_x_mozilla_page_load_details 11:36:47 INFO - PROCESS | 11846 | |i|pagename|runs| 11:36:47 INFO - PROCESS | 11846 | |0;ai-astar;111;107;110;111;112;122;111;111;110;112 11:36:47 INFO - PROCESS | 11846 | |1;audio-beat-detection;167;132;167;184;130;154;158;130;189;133 11:36:47 INFO - PROCESS | 11846 | |2;audio-dft;163;165;165;162;164;166;173;162;166;163 11:36:47 INFO - PROCESS | 11846 | |3;audio-fft;77;73;77;158;77;76;75;77;156;77 11:36:47 INFO - PROCESS | 11846 | |4;audio-oscillator;93;93;154;93;93;93;137;93;93;150 11:36:47 INFO - PROCESS | 11846 | |5;imaging-gaussian-blur;117;117;117;118;118;117;118;117;118;118 11:36:47 INFO - PROCESS | 11846 | |6;imaging-darkroom;147;147;147;146;146;147;148;147;148;146 11:36:47 INFO - PROCESS | 11846 | |7;imaging-desaturate;96;97;96;96;94;96;95;95;96;95 11:36:47 INFO - PROCESS | 11846 | |8;json-parse-financial;58;57;60;57;60;57;64;75;55;66 11:36:47 INFO - PROCESS | 11846 | |9;json-stringify-tinderbox;60;60;60;61;60;63;61;65;60;60 11:36:47 INFO - PROCESS | 11846 | |10;stanford-crypto-aes;75;75;79;75;78;77;85;83;86;77 11:36:47 INFO - PROCESS | 11846 | |11;stanford-crypto-ccm;125;131;125;123;124;134;132;126;208;135 11:36:47 INFO - PROCESS | 11846 | |12;stanford-crypto-pbkdf2;169;164;162;175;163;178;164;166;161;174 11:36:47 INFO - PROCESS | 11846 | |13;stanford-crypto-sha256-iterative;70;73;70;68;76;69;69;70;67;71 11:36:47 INFO - PROCESS | 11846 | __end_tp_report 11:36:47 INFO - PROCESS | 11846 | __start_cc_report 11:36:47 INFO - PROCESS | 11846 | _x_x_mozilla_cycle_collect,886 11:36:47 INFO - PROCESS | 11846 | __end_cc_report 11:36:47 INFO - PROCESS | 11846 | __startTimestamp1460831807665__endTimestamp 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | ------- Summary: start ------- 11:36:47 INFO - PROCESS | 11846 | Number of tests: 14 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#0] ai-astar Cycles:10 Average:111.70 Median:111.00 stddev:3.89 (3.5%) stddev-sans-first:4.12 11:36:47 INFO - PROCESS | 11846 | Values: 111.0 107.0 110.0 111.0 112.0 122.0 111.0 111.0 110.0 112.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#1] audio-beat-detection Cycles:10 Average:154.40 Median:162.50 stddev:22.50 (13.8%) stddev-sans-first:23.39 11:36:47 INFO - PROCESS | 11846 | Values: 167.0 132.0 167.0 184.0 130.0 154.0 158.0 130.0 189.0 133.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#2] audio-dft Cycles:10 Average:164.90 Median:165.00 stddev:3.21 (1.9%) stddev-sans-first:3.33 11:36:47 INFO - PROCESS | 11846 | Values: 163.0 165.0 165.0 162.0 164.0 166.0 173.0 162.0 166.0 163.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#3] audio-fft Cycles:10 Average:92.30 Median:77.00 stddev:34.13 (44.3%) stddev-sans-first:35.75 11:36:47 INFO - PROCESS | 11846 | Values: 77.0 73.0 77.0 158.0 77.0 76.0 75.0 77.0 156.0 77.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#4] audio-oscillator Cycles:10 Average:109.20 Median:93.00 stddev:26.42 (28.4%) stddev-sans-first:27.36 11:36:47 INFO - PROCESS | 11846 | Values: 93.0 93.0 154.0 93.0 93.0 93.0 137.0 93.0 93.0 150.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#5] imaging-gaussian-blur Cycles:10 Average:117.50 Median:118.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 11:36:47 INFO - PROCESS | 11846 | Values: 117.0 117.0 117.0 118.0 118.0 117.0 118.0 117.0 118.0 118.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#6] imaging-darkroom Cycles:10 Average:146.90 Median:147.00 stddev:0.74 (0.5%) stddev-sans-first:0.78 11:36:47 INFO - PROCESS | 11846 | Values: 147.0 147.0 147.0 146.0 146.0 147.0 148.0 147.0 148.0 146.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.84 (0.9%) stddev-sans-first:0.88 11:36:47 INFO - PROCESS | 11846 | Values: 96.0 97.0 96.0 96.0 94.0 96.0 95.0 95.0 96.0 95.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#8] json-parse-financial Cycles:10 Average:60.90 Median:60.00 stddev:6.01 (10.0%) stddev-sans-first:6.28 11:36:47 INFO - PROCESS | 11846 | Values: 58.0 57.0 60.0 57.0 60.0 57.0 64.0 75.0 55.0 66.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#9] json-stringify-tinderbox Cycles:10 Average:61.00 Median:60.50 stddev:1.70 (2.8%) stddev-sans-first:1.76 11:36:47 INFO - PROCESS | 11846 | Values: 60.0 60.0 60.0 61.0 60.0 63.0 61.0 65.0 60.0 60.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#10] stanford-crypto-aes Cycles:10 Average:79.00 Median:78.50 stddev:4.19 (5.3%) stddev-sans-first:4.19 11:36:47 INFO - PROCESS | 11846 | Values: 75.0 75.0 79.0 75.0 78.0 77.0 85.0 83.0 86.0 77.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#11] stanford-crypto-ccm Cycles:10 Average:136.30 Median:131.50 stddev:25.57 (19.4%) stddev-sans-first:26.79 11:36:47 INFO - PROCESS | 11846 | Values: 125.0 131.0 125.0 123.0 124.0 134.0 132.0 126.0 208.0 135.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.60 Median:167.50 stddev:6.06 (3.6%) stddev-sans-first:6.41 11:36:47 INFO - PROCESS | 11846 | Values: 169.0 164.0 162.0 175.0 163.0 178.0 164.0 166.0 161.0 174.0 11:36:47 INFO - PROCESS | 11846 | 11:36:47 INFO - PROCESS | 11846 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.30 Median:70.00 stddev:2.58 (3.7%) stddev-sans-first:2.74 11:36:47 INFO - PROCESS | 11846 | Values: 70.0 73.0 70.0 68.0 76.0 69.0 69.0 70.0 67.0 71.0 11:36:47 INFO - PROCESS | 11846 | -------- Summary: end -------- 11:36:47 INFO - PROCESS | 11846 | 11:36:48 INFO - TEST-INFO | 11846: exit 0 11:36:48 INFO - TEST-OK | kraken | took 61832ms 11:36:48 INFO - SUITE-END | took 1172s 11:36:48 INFO - Completed test suite (00:19:32) 11:36:48 INFO - javascript benchmark 11:36:48 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3084.3985422842543, 3102.0693791862436, 3157.0371036833785, 3166.9366612667745, 3189.553462515248, 5416.106342453495, 5417.3770016448125, 5426.9185962210595, 5437.048516509615, 5456.945430545693, 5373.570114390849, 5487.972560137204, 5567.47109024643, 5572.7770889164485, 5586.776528938837, 4919.0899683558655, 4923.0, 4952.405711314647, 5099.745012749348, 5121.3342265505435, 5038.017586570621, 5051.090803655341, 5080.390353157626, 5087.236914462823, 5097.5667068299235, 4930.926036109461, 4953.578945789613, 4988.176950803113, 5039.168537191359, 5048.621353398473, 4935.358403407534, 4936.777844996948, 4937.925931111036, 4971.0, 4990.451050384455, 4878.414590249157, 4929.433115191763, 4932.753362331869, 4948.331975183376, 4973.055119527315, 5377.784888604451, 5418.2685337479725, 5441.29263195786, 5446.183072539151, 5468.0977638689565, 5820.650760954314, 5836.708164591753, 5870.236869206976, 5879.882402351972, 5901.557383196235, 5748.655080695172, 5882.794102206445, 5906.23218981534, 5906.645601263938, 5918.852028699274, 5488.341399032101, 5502.614816962814, 5509.173623956439, 5525.834224973257, 5573.526250268732, 6030.27636683592, 6031.065184896348, 6033.396660333931, 6043.425874541911, 6049.848753781191, 5628.634138780966, 5713.200151978726, 5797.536197104221, 5801.390853960358, 5814.912776308359, 5764.423557644286, 5889.263842019747, 5889.499392551681, 5889.941100589025, 5926.970365148147, 5825.2135961644635, 5832.9708351457975, 5855.619384739978, 5861.856937897154, 5938.6436813791315, 5694.5159661428415, 5801.94198058014, 5826.592138550261, 5878.794242201502, 5889.528837692974, 4418.469783625921, 4442.68901176921, 4442.755648439303, 4458.264386376277, 4483.08096840147, 3937.2716047530726, 3943.7042221833476, 3947.486826712509, 4018.3369743991916, 4034.072163402434, 5550.58370622205, 5597.692126933058, 5624.887502249932, 5642.210090587321, 5657.830265092054, 5942.61373010753, 5945.881082378415, 5948.226730525091, 5952.821415357546, 5976.820695379059, 5559.082751346064, 5591.720413979366, 5612.691301978431, 5624.91562626561, 5638.577106716931, 4822.903541929142, 4864.951350486521, 4900.436449808247, 4909.729964851896, 4937.7777999990085, 6072.574919755575, 6076.848078798065, 6089.269287685506, 6110.022396416552, 6122.357152499013, 5758.280214973129, 5869.06095024794, 5890.204822348928, 5896.64620122794, 5915.024021036566, 6092.960776441158, 6179.3202747698615, 6182.938170618416, 6204.038374052029, 6209.65846878408, 5699.9145012825675, 5731.054376028075, 5735.770569177186, 5744.971275143765, 5773.653580785166, 5709.314882214161, 5814.76740930358, 5825.592208545361, 5836.328822185334, 5878.118282257696, 5667.631603945731, 5736.110902810071, 5763.049096898964, 5814.244148260868, 5825.854353641193, 5722.3991480895575, 5759.827205183851, 5764.337101233412, 5776.682282474504, 5781.624194427349, 5470.972645136749, 5632.971835140798, 5645.576581756467, 5678.574106942078, 5690.601657883908, 5741.684207368635, 5769.134629805562, 5805.593608447537, 5806.564507662027, 5826.7086645666695, 5644.520215781705, 5652.0, 5685.857853553694, 5686.488216060575, 5687.317521897398], "value": 5405.623745501475, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [587.3979171349366, 620.0265583034635, 636.6402982314993, 640.1645852162932, 644.5327137825075, 37736.245275094516, 38260.99999999996, 38283.80858095713, 38369.0, 38408.23183536327, 41157.58842411575, 41510.58489415105, 41689.16621667565, 41772.791136044354, 41906.37140442896, 8544.18830211129, 8671.869921951176, 8707.47755134694, 8731.563421828883, 8731.738047858575, 8416.284615807665, 8610.052894181636, 8650.783730406727, 8805.823883522326, 8820.426672266281, 8763.079876612928, 8813.823723525558, 8839.60221790021, 8877.0, 8903.332250081237, 8776.122387761205, 8788.033316335199, 8797.736067917973, 8799.736007919773, 8845.159709827556, 8713.390062695615, 8812.691555795516, 8827.646894124227, 8855.114488551159, 8858.86711699325, 40882.59117408818, 41197.176056478704, 41273.0, 41401.0, 41663.7916810414, 2957.6746557878614, 3375.6961873431264, 3536.522569453117, 3909.7263191576603, 4247.469066366704, 27720.861395692893, 28189.57715634267, 28333.858330708215, 28477.857610711813, 29029.56455653167, 4233.322668373045, 4278.465191851019, 4308.590683885026, 4334.393184954109, 4369.759663218521, 258250.0, 260036.0, 260392.0, 263094.68452657806, 263581.0, 36451.0, 37747.0, 60472.697636512414, 61345.0, 61357.0, 35220.29559408798, 35659.10852228715, 35752.0, 35776.821115894774, 35850.46224306637, 14888.0, 15102.54692359231, 15152.242387880562, 15170.469033583771, 15246.847531524543, 12804.80792788109, 12837.101402901893, 12842.743145137045, 12881.484740610458, 12898.161619494704, 8641.524716140673, 8692.434991725517, 8745.387822852466, 8759.474431534129, 8775.561221938877, 3281.786683865541, 3334.3664703706218, 3412.931741365159, 3417.6924076832706, 3423.863045478203, 1032.2774058159318, 1049.2268066966801, 1133.2520536445907, 1167.9474423650956, 1214.987850121505, 31455.21361965969, 32355.35289294201, 32507.18732031718, 33155.0, 33368.33263334768, 1095.802755504001, 1098.4782228441427, 1154.3650991954391, 1155.2317708723604, 1176.2295696318924, 17069.0, 17195.656086878444, 17433.21550530229, 17496.562585935455, 17556.912215439097, 430224.0, 434595.0, 434906.0, 436828.0, 438167.0, 56734.0, 57408.42591574114, 57448.42551574514, 57458.13812792811, 57513.99999999916, 1307.666545031011, 1332.4470344806796, 1336.1181620130667, 1362.7410791949499, 1382.410228237535, 31066.378672425973, 31410.371792563565, 31427.528587070756, 31540.52689209618, 31870.0, 49902.251466228765, 54978.45021549733, 57082.7145864268, 57191.42808571861, 57285.71357143188, 406318.0, 409433.0, 412606.0, 413252.0, 413686.0, 43863.0, 44078.779606101765, 44640.77679611581, 44851.775741121084, 45016.0, 47484.2877356833, 47747.5225247757, 47982.0, 48147.27779083387, 48758.75620621874, 40145.0, 40798.388024180254, 40940.79529602333, 41010.0, 42070.15859682851, 39085.804570976965, 39505.604943950195, 39778.60221397865, 40695.59304407037, 41433.37849932314, 39892.800535997136, 40607.39088913728, 40933.590664092975, 42450.78774606107, 42542.5745742551, 37522.624773751915, 38909.221815564095, 39030.2193956125, 39042.414363783995, 39663.40504892371, 30354.241143970696, 30636.846815765777, 30993.380132397677, 31428.0, 31596.684033159374], "value": 18820.276520743693, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [387.1386165781137, 394.7473616885192, 401.44800898764197, 404.3853342918763, 406.30116200135757, 13830.515931942384, 15237.0, 17601.559961000967, 18502.722459163124, 18509.074546272685, 11504.769904601902, 11856.170068095236, 17310.307587696476, 17630.206640701166, 17647.0, 4802.639802014845, 4902.852914412556, 4930.063287975291, 4945.208766597345, 5015.473375295578, 5004.199328107504, 5166.483351664841, 5289.8942021159555, 5297.046531624306, 5299.867503312429, 5263.31576895005, 5272.367315922094, 5278.736063196825, 5288.233206185101, 5305.204219367107, 5152.716600586966, 5164.070467315882, 5171.17261238202, 5178.559822415099, 5260.973695131538, 4963.826266080706, 5017.54842064216, 5097.541221290065, 5108.770105345268, 5110.8466745997675, 12934.0, 14117.78823317651, 22049.22827701023, 22497.662535061987, 22537.211197608005, 2215.501512159751, 2282.7945484906436, 2319.0607803839303, 2362.681038059857, 2740.780737540992, 9649.807003859954, 9782.070703283176, 12015.939920300343, 13060.281684507348, 13459.528916487974, 1871.9157637906192, 1886.3303527247767, 1917.5844573691375, 1986.2750096214922, 2017.7679566849706, 57778.7111064442, 72788.6360568199, 76084.23915760883, 77179.61410192912, 77978.0, 9045.683401081062, 9773.706788796348, 9862.50687465624, 10247.692569222936, 10643.627473038407, 13137.080404371602, 13199.0, 13285.933570332087, 13291.601251962456, 13296.069275150647, 7847.1368149503505, 7868.72459463916, 7909.5649739263745, 7989.760307190793, 8085.514869107872, 7826.647800848976, 7897.1707970662255, 7898.091719452336, 8096.595170241464, 8119.741440076679, 4026.9452927405405, 4038.172174704179, 4112.115895082572, 4172.311568591209, 4192.622663960258, 1919.9424017279505, 1969.2713695932596, 1974.9703754443694, 1998.9900050499655, 2022.5752591955854, 919.5769945824861, 980.8773903262093, 1011.4184344002228, 1030.721705139608, 1051.7686109055996, 18961.90519047396, 19058.714119288223, 19070.809291907182, 19167.80832191688, 19497.0, 970.5244430229137, 1040.625374865048, 1061.713337398898, 1064.446487826326, 1126.0766171739258, 10412.895871041193, 10783.730406739738, 10956.945215273872, 10962.013418792347, 10976.451177441097, 468777.0, 469936.0, 470307.0, 476373.0, 492726.0, 79645.60177199077, 84786.5760671205, 85540.57229713812, 86757.0, 87852.0, 1067.1942683274233, 1070.3310430980637, 1077.7575045614674, 1078.5254488025087, 1085.6580177244143, 16645.334186632885, 16856.325746969986, 16883.32466701318, 16992.57518562046, 17086.40197593078, 37485.0, 38799.22401552009, 38934.0, 39391.40912886251, 39902.201955961296, 51959.74020129875, 54971.175432369346, 55206.44793552174, 55431.722841385534, 55635.72182139225, 7556.357709594746, 7832.0, 8023.077346105039, 8230.300424463987, 8815.294776417742, 9362.344635875423, 12991.870081299066, 13017.544385946447, 13037.15258508194, 13237.338133093499, 11363.431828408382, 11514.42427878586, 11721.0, 11930.582429614922, 11970.640880773592, 6036.63780173191, 10943.671689849318, 11756.295337176232, 11826.586069487526, 12156.452959616661, 11540.653780386601, 11970.521179152736, 12022.098342624164, 12048.216865903689, 12321.568745094237, 8120.066192387951, 8135.511869287861, 8148.511089334659, 8162.795930101795, 8195.71315003996, 11390.37352945596, 11410.714732131431, 11476.598319058792, 11745.354005529778, 11783.52865885355], "value": 8757.166526665878, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1511.7505611574095, 1521.946731864385, 1663.5508412728564, 1745.3891138101658, 1756.2448147296666, 7656.961715191416, 8199.754007379774, 8265.83468330633, 8563.828723425528, 8577.785555361112, 8240.423170378075, 8287.088420273765, 8331.666733330674, 8352.540610266433, 8362.205590468911, 2210.8120809731154, 2251.1558165687866, 2251.2120757734824, 2256.2328808205207, 2264.524449865522, 2194.319760874126, 2207.172310383606, 2215.313252891609, 2227.064632854197, 2228.9108435662556, 2163.0, 2170.0451801207496, 2173.7065496157975, 2176.1295481807324, 2209.3371988403496, 2159.8704077755306, 2165.1664109317867, 2171.6416791229426, 2177.640689286266, 2179.411558879102, 2156.2884248198056, 2172.076867331378, 2188.9233876814237, 2196.703445034932, 2201.8238540916686, 8442.409031367806, 8542.78643033929, 8557.0, 8576.914230857674, 8597.699080532151, 4926.1379258629595, 5075.796968121308, 5097.8215762448135, 5097.923531147036, 5117.437081920985, 3200.0, 3247.9837600811843, 3344.966550334514, 3370.882019129319, 3390.593128824532, 1040.2458217792116, 1060.2419270221828, 1068.722132245614, 1072.3351522056375, 1123.9213255072148, 11618.883811161864, 11633.53465861356, 11748.941255293754, 11795.410229488578, 11877.16859819813, 4345.9348109778375, 4439.511653718088, 4609.078184363074, 4651.465081515601, 4653.302004699322, 10075.697729068139, 10087.798244035079, 10089.545970431202, 10089.899101008896, 10103.393796372242, 5107.157319042391, 5109.489051094861, 5112.6421150519855, 5123.462036486116, 5132.794688212504, 4269.210196113729, 4625.121226966866, 4648.558386953234, 4680.625549955996, 4725.763711814396, 3867.61323867611, 3867.7485963412287, 3957.762534247954, 3965.0087478130467, 3983.880483585497, 1266.8226448297246, 1280.3470230182488, 1285.2609749394135, 1297.0, 1299.6101169649066, 775.0, 908.68650315641, 946.3753922411175, 967.8209531236744, 979.3487330924997, 5920.2007728956905, 6017.187679663277, 6026.728797204137, 6134.5092392608485, 6147.139400483936, 441.90719948810465, 446.5043801380465, 460.3876843797808, 463.80288377439456, 464.6584760201317, 4073.3075377185355, 4078.7552746835286, 4081.775502347399, 4100.323446631332, 4120.711550191518, 10206.438645874548, 10623.681289561326, 10701.0, 10709.143268538499, 10715.19636027301, 10622.46887655614, 10630.0, 10634.361938283728, 10659.14726821868, 10681.946590266998, 8018.0, 8037.196280372033, 8138.145494722969, 8144.633491492897, 8154.633041513146, 5738.282714660668, 5744.569157313134, 5763.6541807491685, 5823.272090988627, 5871.324797648154, 9653.71038868807, 9670.75823104428, 9841.0, 9893.505324733878, 9910.454924978907, 9808.65669701557, 9989.350692204984, 10068.144207742424, 10070.647527336509, 10178.0, 6745.561538499982, 7305.561666300039, 7562.470627056054, 7586.393088553013, 7633.274838890296, 8418.705345312885, 8480.10958849312, 8485.151484851713, 8512.914870851213, 8538.743837684879, 7540.924590754023, 7769.572673503011, 7794.532328060334, 7857.0, 7864.764057078297, 7565.735199268, 7571.432142589438, 7577.431692623186, 7665.961670191613, 7686.8078298040755, 6995.440364770908, 7025.437964962893, 7036.437085033082, 7046.612436316052, 7093.858122837411, 4928.211486162197, 4936.7284799336385, 5048.141815891234, 5122.615803814803, 5127.179651255781, 5114.539691427789, 5136.486351364983, 5148.613853961043, 5191.402988656353, 5321.733913304397], "value": 4442.639221488122, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [312.7419878600154, 318.93780712761014, 320.3416978109983, 324.1652744183727, 327.73289768838396, 5855.151003104547, 5886.0, 6042.728077236524, 6162.352952939944, 6167.136600875881, 5973.880522389561, 5974.0, 5979.970100149493, 6024.186734790802, 6028.909566356509, 4541.250693635563, 4545.36364908913, 4553.248713962193, 4556.521565235652, 4562.726236425809, 4436.822527098912, 4539.704919180259, 4573.634109271267, 4577.954220457803, 4578.519255478177, 4497.482789479219, 4502.662300327472, 4504.346869703891, 4533.365328853963, 4536.637069034486, 4508.436445444319, 4541.523140070294, 4555.74943378114, 4556.407667003285, 4557.521460246693, 3879.497723968053, 3943.684505239574, 3988.900277493057, 3999.9400008999887, 4002.2195671844, 5729.627574207705, 5736.426357364272, 5763.337216220105, 5766.625169363978, 5782.479576838105, 5218.8695282617855, 5230.660007099526, 5245.0, 5248.186531087649, 5249.895002099975, 5973.492253158487, 6215.658138802364, 6225.346338634468, 6232.594881332699, 6244.906326405107, 4334.154839806239, 4352.238358287287, 4354.869353919387, 4363.214621368153, 4369.082492676542, 6288.434040936292, 6593.472522198213, 6599.505037122235, 6601.438877695402, 6609.966950165219, 4468.642508599304, 4470.150671372428, 4483.843065492692, 4487.922898504401, 4488.4613846338, 4515.909681806345, 4528.9094218116115, 4532.501424843264, 4542.364069030338, 4546.340780586863, 5166.147585648326, 5174.818881339135, 5207.843764687065, 5214.817481388133, 5216.747980484733, 5960.37416071315, 6104.755809767559, 6303.590266632654, 6310.211223597051, 6318.462930650946, 1578.9605259868595, 1617.2156504095503, 1619.667968066567, 1624.4395683489413, 1627.4629372307347, 1053.5522402978856, 1069.5667805141147, 1073.8013467508379, 1079.1474734959452, 1082.1667316166508, 6052.54871776931, 6056.152138700585, 6073.967425537669, 6082.1789058477425, 6101.511879049665, 6410.294867564564, 6443.29123796382, 6453.515986301046, 6492.513061520405, 6565.868682626321, 5862.508433915569, 6044.788432404933, 6054.243219597551, 6095.817125486243, 6129.11127886454, 3485.8779942701885, 3495.5106285120105, 3517.806520641338, 3536.45184996326, 3554.306910152547, 6581.86836263272, 6690.966545167243, 6718.328167183243, 6719.630420326929, 6788.185417749902, 6673.599584024974, 6674.199096108498, 6688.732450702015, 6691.26396096429, 6697.22981857083, 6610.900836487456, 6796.184457865088, 6805.455563555002, 6832.795016149524, 6846.520743548003, 6500.934990650222, 6527.412532872065, 6529.183852018497, 6535.803925882231, 6544.9672751637845, 6311.968440157953, 6485.416312531895, 6504.0, 6515.511336649865, 6532.203643997938, 6818.420434262945, 6831.0, 6841.555298905555, 6847.6576171190245, 6848.7260509579055, 4507.3689683445, 4552.271636538138, 4552.544745525421, 4557.361969324231, 4615.14619795339, 6200.193974783429, 6424.164858568356, 6528.543001989815, 6562.818692635372, 6612.636305003271, 6347.809565713036, 6386.489080873612, 6386.776462823779, 6415.967920160556, 6418.6469744164515, 6164.291106522807, 6338.397852204033, 6363.96818015907, 6373.490120790419, 6408.58344207625, 6263.279722831932, 6272.686365681789, 6276.121343012073, 6307.148534947723, 6310.747570097328, 6345.302016778059, 6374.58565193261, 6420.518461115342, 6422.036694495863, 6429.51778616615, 5995.520358371407, 6293.244810622571, 6305.684715764285, 6311.400416960381, 6318.778842740482], "value": 4764.787894259641, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [763.4651563262096, 798.872180451128, 802.5826570183508, 803.9196080391962, 812.528733334666, 12195.390230488474, 12221.816672749916, 12415.8892988192, 12490.250584964908, 12523.624291271264, 12303.32331721755, 12479.064070194727, 12674.0, 12681.0, 12683.809742853842, 771.8301973565807, 792.4373694676772, 799.0571126071262, 802.2739420824164, 815.6696537902159, 793.9603019848985, 796.4385108498494, 798.6206551887865, 801.418971245848, 803.5058439059994, 839.4669384940577, 850.3962186847345, 853.1937319233327, 853.4282031039219, 854.406187699549, 842.0653075086649, 843.9957800211021, 844.2950136635916, 845.2266176448542, 848.7284069097922, 611.5382885921146, 613.1446631948452, 620.3517324395972, 623.1338439569003, 626.0234034905562, 12946.611601651966, 12996.935015324958, 13006.544770933067, 13046.086773925828, 13074.738505229938, 12931.935340323238, 13013.219206847525, 13312.0, 13346.0, 13503.0, 11273.943630281878, 11672.766544669144, 11727.589534366341, 11734.178607497479, 11926.105542084379, 3782.9054273643105, 3794.696424286078, 3845.942310865339, 3927.7839718815453, 3942.4086387041884, 57795.42204577942, 58027.0, 59444.40555594432, 59517.40482595205, 59984.400155998315, 10471.94764026175, 10937.781244375068, 11084.168687348481, 11167.776644467065, 11407.600733974272, 19390.4182874514, 19410.514737131685, 19421.805781942, 19447.805521944883, 19488.0, 7841.725539606086, 7901.407394445439, 7991.880121798177, 8036.919630803734, 8277.130901255401, 4727.881802954885, 4753.0, 4797.976010119997, 4851.078295123915, 4909.705417674951, 3190.409774191782, 3261.559689441895, 3291.2759192977987, 3301.042697617712, 3312.6521715220038, 581.6121094623833, 583.5681595619296, 585.871108356161, 592.120700759372, 593.2613895699795, 608.6753615561373, 710.8365076032542, 724.4349407462188, 731.2102928836844, 738.837455759732, 8732.8690069649, 8751.168638979287, 8871.290296776242, 8964.820703585892, 9073.682421115229, 565.7623798004848, 577.4168090228815, 656.0323522803826, 677.529117263507, 722.0613202836291, 3954.2486927483687, 4055.2903241932545, 4103.425520427142, 4112.218678451085, 4206.26390381682, 63086.684566577795, 65011.67494162499, 65283.34716652868, 65422.34577654258, 66185.33814661889, 56430.43569564334, 56566.43433565694, 56712.0, 56859.43140568541, 57413.42586574164, 47743.76128119337, 48411.5158848407, 48804.755976219894, 49475.50524494709, 49488.25767613489, 8047.315978141924, 8104.230098140667, 8250.174982501701, 8251.2986396157, 8420.4947703138, 34082.31835363329, 34866.30267394587, 35136.64863351436, 35766.0, 35911.82044089763, 47503.762481187376, 49583.256251156985, 51437.7428112857, 51616.74191629168, 51721.482785173175, 12131.272123672608, 12295.44670489848, 12395.070369722487, 12483.500659973863, 12580.559680411141, 11302.604408845651, 12891.806622900851, 13179.60461186166, 13704.451821927012, 14073.0, 11474.426278685865, 11551.422428878355, 11802.881971180179, 11817.586384476503, 11851.644450666494, 12080.0, 12720.6819829505, 12742.68143296425, 12780.1053926228, 12926.935365323114, 11660.125490588409, 11771.352575608424, 12015.939920300343, 12260.203086799329, 12622.242665440102, 8477.660893564189, 10028.849567256351, 10320.380777153396, 10426.165906727596, 10648.84026739584, 11057.72355691082, 11084.667459976214, 11152.735736905946, 11275.492602832728, 11363.943180284046], "value": 6617.64712254113, "unit": "score"}], "name": "dromaeo_css", "value": 7069.31112220535, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 107.0, 110.0, 111.0, 112.0, 122.0, 111.0, 111.0, 110.0, 112.0], "value": 111.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 132.0, 167.0, 184.0, 130.0, 154.0, 158.0, 130.0, 189.0, 133.0], "value": 154.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 165.0, 165.0, 162.0, 164.0, 166.0, 173.0, 162.0, 166.0, 163.0], "value": 164.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 73.0, 77.0, 158.0, 77.0, 76.0, 75.0, 77.0, 156.0, 77.0], "value": 92.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 93.0, 154.0, 93.0, 93.0, 93.0, 137.0, 93.0, 93.0, 150.0], "value": 109.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 118.0, 118.0, 117.0, 118.0, 117.0, 118.0, 118.0], "value": 117.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 147.0, 146.0, 146.0, 147.0, 148.0, 147.0, 148.0, 146.0], "value": 146.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 97.0, 96.0, 96.0, 94.0, 96.0, 95.0, 95.0, 96.0, 95.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 57.0, 60.0, 57.0, 60.0, 57.0, 64.0, 75.0, 55.0, 66.0], "value": 60.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 60.0, 60.0, 61.0, 60.0, 63.0, 61.0, 65.0, 60.0, 60.0], "value": 61.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 79.0, 75.0, 78.0, 77.0, 85.0, 83.0, 86.0, 77.0], "value": 79.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [125.0, 131.0, 125.0, 123.0, 124.0, 134.0, 132.0, 126.0, 208.0, 135.0], "value": 136.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 164.0, 162.0, 175.0, 163.0, 178.0, 164.0, 166.0, 161.0, 174.0], "value": 167.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 73.0, 70.0, 68.0, 76.0, 69.0, 69.0, 70.0, 67.0, 71.0], "value": 70.3, "unit": "score"}], "name": "kraken", "value": 1567.6, "alertThreshold": 2.0}]} 11:36:48 INFO - Return code: 0 11:36:48 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 11:36:48 ERROR - # TBPL SUCCESS # 11:36:48 INFO - Running post-action listener: _resource_record_post_action 11:36:48 INFO - Running post-run listener: _resource_record_post_run 11:36:50 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 0; Write bytes: 401158144; Read time: 0; Write time: 293616 11:36:50 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 13828096; Read time: 0; Write time: 11112 11:36:50 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 0; Write bytes: 289464320; Read time: 0; Write time: 147048 11:36:50 INFO - Running post-run listener: _upload_blobber_files 11:36:50 INFO - Blob upload gear active. 11:36:50 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:36:50 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 11:36:50 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'] 11:36:50 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 11:36:50 INFO - (blobuploader) - INFO - Open directory for files ... 11:36:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 11:36:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:36:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:36:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 11:36:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:36:51 INFO - (blobuploader) - INFO - Done attempting. 11:36:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 11:36:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:36:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:36:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 11:36:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:36:52 INFO - (blobuploader) - INFO - Done attempting. 11:36:52 INFO - (blobuploader) - INFO - Iteration through files over. 11:36:52 INFO - Return code: 0 11:36:52 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:36:52 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:36:52 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/eb789b4b7362ecb2327dc4441711d02570a6c5df2bdf444b47bd2c335847cd493b1dcca0b42eb2bf6963dbd3e11f2c9912df419524b1774a1463b936f0f8ed10", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b355d783d35e9211fba2d8236a61808f9ee14925372068f8c4dfc5a6374e01d3a16769afe938c65c95de22df6a1ca327567ae98a601018621dc175e91295607a"} 11:36:52 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:36:52 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:36:52 INFO - Contents: 11:36:52 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/eb789b4b7362ecb2327dc4441711d02570a6c5df2bdf444b47bd2c335847cd493b1dcca0b42eb2bf6963dbd3e11f2c9912df419524b1774a1463b936f0f8ed10", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b355d783d35e9211fba2d8236a61808f9ee14925372068f8c4dfc5a6374e01d3a16769afe938c65c95de22df6a1ca327567ae98a601018621dc175e91295607a"} 11:36:52 INFO - Running post-run listener: copy_logs_to_upload_dir 11:36:52 INFO - Copying logs to upload dir... 11:36:52 INFO - mkdir: /builds/slave/test/build/upload/logs 11:36:52 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.654863 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-04-16 11:36:50.023585) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-16 11:36:50.027520) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251 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/eb789b4b7362ecb2327dc4441711d02570a6c5df2bdf444b47bd2c335847cd493b1dcca0b42eb2bf6963dbd3e11f2c9912df419524b1774a1463b936f0f8ed10", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b355d783d35e9211fba2d8236a61808f9ee14925372068f8c4dfc5a6374e01d3a16769afe938c65c95de22df6a1ca327567ae98a601018621dc175e91295607a"} build_url:https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011305 build_url: 'https://queue.taskcluster.net/v1/task/VpjGGumQR525rc6-i3-jSA/artifacts/public/build/firefox-48.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/eb789b4b7362ecb2327dc4441711d02570a6c5df2bdf444b47bd2c335847cd493b1dcca0b42eb2bf6963dbd3e11f2c9912df419524b1774a1463b936f0f8ed10", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b355d783d35e9211fba2d8236a61808f9ee14925372068f8c4dfc5a6374e01d3a16769afe938c65c95de22df6a1ca327567ae98a601018621dc175e91295607a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-16 11:36:50.051834) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-16 11:36:50.052145) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1460828771.414507-980050251 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004491 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-16 11:36:50.134917) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-16 11:36:50.135237) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-16 11:36:50.135530) ========= ========= Total master_lag: 0.15 =========