builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-012 starttime: 1464949454.97 results: success (0) buildid: 20160603004101 builduid: d3d53c7dcb0f4d7795846bf280fe9beb revision: effbb9ad4e93c4383e484f3a515d23194d3c6329 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:14.968026) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:14.968529) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:14.968878) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:14.989388) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:14.989834) ========= 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=2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-03 03:24: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% 102M=0s 2016-06-03 03:24:15 (102 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.082733 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.099611) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.100002) ========= 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=2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022086 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.154481) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.157935) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev effbb9ad4e93c4383e484f3a515d23194d3c6329 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev effbb9ad4e93c4383e484f3a515d23194d3c6329 --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=2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-03 03:24:15,834 truncating revision to first 12 chars 2016-06-03 03:24:15,834 Setting DEBUG logging. 2016-06-03 03:24:15,834 attempt 1/10 2016-06-03 03:24:15,834 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/effbb9ad4e93?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-03 03:24:16,143 unpacking tar archive at: mozilla-aurora-effbb9ad4e93/testing/mozharness/ program finished with exit code 0 elapsedTime=0.651940 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.826837) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.827156) ========= script_repo_revision: effbb9ad4e93c4383e484f3a515d23194d3c6329 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.827543) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.827900) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-03 03:24:15.838929) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-06-03 03:24:15.839237) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:24:16 INFO - MultiFileLogger online at 20160603 03:24:16 in /builds/slave/test 03:24:16 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 03:24:16 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:24:16 INFO - {'append_to_log': False, 03:24:16 INFO - 'base_work_dir': '/builds/slave/test', 03:24:16 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 03:24:16 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:24:16 INFO - 'branch': 'Mozilla-Aurora', 03:24:16 INFO - 'buildbot_json_path': 'buildprops.json', 03:24:16 INFO - 'config_files': ('talos/linux_config.py',), 03:24:16 INFO - 'default_actions': ('clobber', 03:24:16 INFO - 'read-buildbot-config', 03:24:16 INFO - 'download-and-extract', 03:24:16 INFO - 'populate-webroot', 03:24:16 INFO - 'create-virtualenv', 03:24:16 INFO - 'install', 03:24:16 INFO - 'run-tests'), 03:24:16 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:24:16 INFO - 'download_minidump_stackwalk': True, 03:24:16 INFO - 'download_symbols': 'ondemand', 03:24:16 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:24:16 INFO - 'tooltool.py': '/tools/tooltool.py', 03:24:16 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:24:16 INFO - '/tools/misc-python/virtualenv.py')}, 03:24:16 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:24:16 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:24:16 INFO - 'installer_path': 'installer.exe', 03:24:16 INFO - 'log_level': 'info', 03:24:16 INFO - 'log_name': 'talos', 03:24:16 INFO - 'log_to_console': True, 03:24:16 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:24:16 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:24:16 INFO - 'opt_config_files': (), 03:24:16 INFO - 'pip_index': False, 03:24:16 INFO - 'sps_profile': False, 03:24:16 INFO - 'sps_profile_interval': 0, 03:24:16 INFO - 'suite': 'dromaeojs-e10s', 03:24:16 INFO - 'system_bits': '32', 03:24:16 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:24:16 INFO - 'title': 'talos-linux64-ix-012', 03:24:16 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:24:16 INFO - 'use_talos_json': True, 03:24:16 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:24:16 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:24:16 INFO - 'work_dir': 'build'} 03:24:16 INFO - ##### 03:24:16 INFO - ##### Running clobber step. 03:24:16 INFO - ##### 03:24:16 INFO - Running pre-action listener: _resource_record_pre_action 03:24:16 INFO - Running main action method: clobber 03:24:16 INFO - rmtree: /builds/slave/test/build 03:24:16 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:24:17 INFO - Running post-action listener: _resource_record_post_action 03:24:17 INFO - ##### 03:24:17 INFO - ##### Running read-buildbot-config step. 03:24:17 INFO - ##### 03:24:17 INFO - Running pre-action listener: _resource_record_pre_action 03:24:17 INFO - Running main action method: read_buildbot_config 03:24:17 INFO - Using buildbot properties: 03:24:17 INFO - { 03:24:17 INFO - "project": "", 03:24:17 INFO - "product": "firefox", 03:24:17 INFO - "script_repo_revision": "production", 03:24:17 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 03:24:17 INFO - "repository": "", 03:24:17 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 03:24:17 INFO - "buildid": "20160603004101", 03:24:17 INFO - "stage_platform": "linux64-pgo", 03:24:17 INFO - "basedir": "/builds/slave/test", 03:24:17 INFO - "nightly_build": "True", 03:24:17 INFO - "buildnumber": 382, 03:24:17 INFO - "slavename": "talos-linux64-ix-012", 03:24:17 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 03:24:17 INFO - "platform": "ubuntu64_hw", 03:24:17 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 03:24:17 INFO - "branch": "mozilla-aurora", 03:24:17 INFO - "repo_path": "releases/mozilla-aurora", 03:24:17 INFO - "revision": "effbb9ad4e93c4383e484f3a515d23194d3c6329", 03:24:17 INFO - "pgo_build": "True", 03:24:17 INFO - "builduid": "d3d53c7dcb0f4d7795846bf280fe9beb", 03:24:17 INFO - "slavebuilddir": "test" 03:24:17 INFO - } 03:24:17 INFO - Found installer url https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2. 03:24:17 INFO - Running post-action listener: _resource_record_post_action 03:24:17 INFO - ##### 03:24:17 INFO - ##### Running download-and-extract step. 03:24:17 INFO - ##### 03:24:17 INFO - Running pre-action listener: _resource_record_pre_action 03:24:17 INFO - Running main action method: download_and_extract 03:24:17 INFO - mkdir: /builds/slave/test/build/tests 03:24: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')]} 03:24:17 INFO - https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 03:24:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 03:24:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 03:24:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 03:24:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 03:24:22 INFO - Downloaded 1361 bytes. 03:24:22 INFO - Reading from file /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 03:24:22 INFO - Using the following test package requirements: 03:24:22 INFO - {u'common': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'], 03:24:22 INFO - u'cppunittest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 03:24:22 INFO - u'firefox-48.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 03:24:22 INFO - u'gtest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 03:24:22 INFO - u'firefox-48.0a2.en-US.linux-x86_64.gtest.tests.zip'], 03:24:22 INFO - u'jittest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 03:24:22 INFO - u'jsshell-linux-x86_64.zip'], 03:24:22 INFO - u'mochitest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 03:24:22 INFO - u'firefox-48.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 03:24:22 INFO - u'mozbase': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'], 03:24:22 INFO - u'reftest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 03:24:22 INFO - u'firefox-48.0a2.en-US.linux-x86_64.reftest.tests.zip'], 03:24:22 INFO - u'talos': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 03:24:22 INFO - u'firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'], 03:24:22 INFO - u'web-platform': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 03:24:22 INFO - u'firefox-48.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 03:24:22 INFO - u'xpcshell': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 03:24:22 INFO - u'firefox-48.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 03:24:22 INFO - Downloading packages: [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:24: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')]} 03:24:22 INFO - https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:24:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 03:24:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 03:24:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 03:24:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:24:29 INFO - Downloaded 24174681 bytes. 03:24:29 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:24:29 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 03:24:31 INFO - Return code: 0 03:24:31 INFO - Downloading packages: [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 03:24:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:24:31 INFO - https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:24:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 03:24:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 03:24:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 03:24:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:24:33 INFO - Downloaded 24174681 bytes. 03:24:33 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:24:33 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 03:24:34 INFO - Return code: 0 03:24:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 03:24:34 INFO - https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:24:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 03:24:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 03:24:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 03:24:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 03:24:35 INFO - Downloaded 10840145 bytes. 03:24:35 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:24:35 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 03:24:35 INFO - Return code: 0 03:24: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')]} 03:24:35 INFO - https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:24:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 03:24:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 03:24:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 03:24:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 03:24:37 INFO - Downloaded 62781519 bytes. 03:24:37 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 03:24:37 INFO - mkdir: /builds/slave/test/properties 03:24:37 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:24:37 INFO - Writing to file /builds/slave/test/properties/build_url 03:24:37 INFO - Contents: 03:24:37 INFO - build_url:https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 03:24:38 INFO - Running post-action listener: _resource_record_post_action 03:24:38 INFO - Running post-action listener: set_extra_try_arguments 03:24:38 INFO - ##### 03:24:38 INFO - ##### Running populate-webroot step. 03:24:38 INFO - ##### 03:24:38 INFO - Running pre-action listener: _resource_record_pre_action 03:24:38 INFO - Running main action method: populate_webroot 03:24:38 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:24:38 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:24:38 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:24:38 INFO - '--tppagecycles', 03:24:38 INFO - '7'], 03:24:38 INFO - 'tests': ['tsvgm']}}, 03:24:38 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:24:38 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:24:38 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:24:38 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:24:38 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:24:38 INFO - 'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:24:38 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:24:38 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:24:38 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:24:38 INFO - 'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['damp', 'tps']}, 03:24:38 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:24:38 INFO - 'tests': ['damp', 'tps']}, 03:24:38 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['dromaeo_dom']}, 03:24:38 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:24:38 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['a11yr', 03:24:38 INFO - 'ts_paint', 03:24:38 INFO - 'tpaint', 03:24:38 INFO - 'sessionrestore', 03:24:38 INFO - 'sessionrestore_no_auto_restore', 03:24:38 INFO - 'tabpaint']}, 03:24:38 INFO - 'other-e10s': {'tests': ['a11yr', 03:24:38 INFO - 'ts_paint', 03:24:38 INFO - 'tpaint', 03:24:38 INFO - 'sessionrestore', 03:24:38 INFO - 'sessionrestore_no_auto_restore', 03:24:38 INFO - 'tabpaint']}, 03:24:38 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:24:38 INFO - 'ts_paint', 03:24:38 INFO - 'tpaint', 03:24:38 INFO - 'sessionrestore', 03:24:38 INFO - 'sessionrestore_no_auto_restore', 03:24:38 INFO - 'tabpaint']}, 03:24:38 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:24:38 INFO - 'ts_paint', 03:24:38 INFO - 'tpaint', 03:24:38 INFO - 'sessionrestore', 03:24:38 INFO - 'sessionrestore_no_auto_restore', 03:24:38 INFO - 'tabpaint']}, 03:24:38 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['a11yr', 03:24:38 INFO - 'ts_paint', 03:24:38 INFO - 'tpaint', 03:24:38 INFO - 'sessionrestore', 03:24:38 INFO - 'sessionrestore_no_auto_restore', 03:24:38 INFO - 'tabpaint']}, 03:24:38 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['a11yr', 03:24:38 INFO - 'ts_paint', 03:24:38 INFO - 'tpaint', 03:24:38 INFO - 'sessionrestore', 03:24:38 INFO - 'sessionrestore_no_auto_restore', 03:24:38 INFO - 'tabpaint']}, 03:24:38 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['tsvgx', 03:24:38 INFO - 'tsvgr_opacity', 03:24:38 INFO - 'tart', 03:24:38 INFO - 'tscrollx', 03:24:38 INFO - 'cart']}, 03:24:38 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:24:38 INFO - 'tsvgr_opacity', 03:24:38 INFO - 'tart', 03:24:38 INFO - 'tscrollx', 03:24:38 INFO - 'cart']}, 03:24:38 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:24:38 INFO - 'talos_options': ['--disable-e10s'], 03:24:38 INFO - 'tests': ['tp5o']}, 03:24:38 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:24:38 INFO - 'tests': ['tp5o']}, 03:24:38 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:24:38 INFO - 'talos_options': ['--disable-e10s', 03:24:38 INFO - '--xperf_path', 03:24:38 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:24:38 INFO - 'tests': ['tp5n']}, 03:24:38 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:24:38 INFO - 'talos_options': ['--xperf_path', 03:24:38 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:24:38 INFO - 'tests': ['tp5n']}}, 03:24:38 INFO - 'talos.zip': {'path': '', 03:24:38 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:24:38 INFO - Running post-action listener: _resource_record_post_action 03:24:38 INFO - ##### 03:24:38 INFO - ##### Running create-virtualenv step. 03:24:38 INFO - ##### 03:24:38 INFO - Running pre-action listener: _resource_record_pre_action 03:24:38 INFO - Running main action method: create_virtualenv 03:24:38 INFO - Creating virtualenv /builds/slave/test/build/venv 03:24:38 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 03:24:38 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:24:38 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:24:38 INFO - Using real prefix '/usr' 03:24:38 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:24:38 INFO - Installing distribute.............................................................................................................................................................................................done. 03:24:40 INFO - Installing pip.................done. 03:24:40 INFO - Return code: 0 03:24:40 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:24: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')]} 03:24:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24: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')]} 03:24:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24: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', 'pip>=1.5'] in /builds/slave/test/build 03:24: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 pip>=1.5 03:24:40 INFO - Using env: {'DISPLAY': ':0', 03:24:40 INFO - 'HOME': '/home/cltbld', 03:24:40 INFO - 'LANG': 'en_US.UTF-8', 03:24:40 INFO - 'LANGUAGE': 'en_US:en', 03:24:40 INFO - 'LOGNAME': 'cltbld', 03:24:40 INFO - 'MAIL': '/var/mail/cltbld', 03:24:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:40 INFO - 'MOZ_NO_REMOTE': '1', 03:24:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:40 INFO - 'NO_EM_RESTART': '1', 03:24:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:40 INFO - 'PWD': '/builds/slave/test', 03:24:40 INFO - 'SHELL': '/bin/bash', 03:24:40 INFO - 'SHLVL': '1', 03:24:40 INFO - 'TERM': 'linux', 03:24:40 INFO - 'TMOUT': '86400', 03:24:40 INFO - 'USER': 'cltbld', 03:24:40 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:40 INFO - '_': '/tools/buildbot/bin/python'} 03:24:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:40 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 03:24:40 INFO - Cleaning up... 03:24:40 INFO - Return code: 0 03:24:40 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 03:24: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')]} 03:24:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24: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')]} 03:24:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24: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', '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 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24: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', 'psutil>=0.7.1'] in /builds/slave/test/build 03:24: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 psutil>=0.7.1 03:24:40 INFO - Using env: {'DISPLAY': ':0', 03:24:40 INFO - 'HOME': '/home/cltbld', 03:24:40 INFO - 'LANG': 'en_US.UTF-8', 03:24:40 INFO - 'LANGUAGE': 'en_US:en', 03:24:40 INFO - 'LOGNAME': 'cltbld', 03:24:40 INFO - 'MAIL': '/var/mail/cltbld', 03:24:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:40 INFO - 'MOZ_NO_REMOTE': '1', 03:24:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:40 INFO - 'NO_EM_RESTART': '1', 03:24:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:40 INFO - 'PWD': '/builds/slave/test', 03:24:40 INFO - 'SHELL': '/bin/bash', 03:24:40 INFO - 'SHLVL': '1', 03:24:40 INFO - 'TERM': 'linux', 03:24:40 INFO - 'TMOUT': '86400', 03:24:40 INFO - 'USER': 'cltbld', 03:24:40 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:40 INFO - '_': '/tools/buildbot/bin/python'} 03:24:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:41 INFO - Downloading/unpacking psutil>=0.7.1 03:24:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:24:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:24:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:24:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:24:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:24:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:24:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:24:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:24:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:24:43 INFO - Installing collected packages: psutil 03:24:43 INFO - Running setup.py install for psutil 03:24:43 INFO - building 'psutil._psutil_linux' extension 03:24:43 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 03:24:43 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 03:24:43 INFO - building 'psutil._psutil_posix' extension 03:24:43 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 03:24:43 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 03:24:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:24:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:24:43 INFO - Successfully installed psutil 03:24:43 INFO - Cleaning up... 03:24:43 INFO - Return code: 0 03:24:43 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 03:24: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')]} 03:24:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24: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')]} 03:24:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 03:24:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 03:24:43 INFO - Using env: {'DISPLAY': ':0', 03:24:43 INFO - 'HOME': '/home/cltbld', 03:24:43 INFO - 'LANG': 'en_US.UTF-8', 03:24:43 INFO - 'LANGUAGE': 'en_US:en', 03:24:43 INFO - 'LOGNAME': 'cltbld', 03:24:43 INFO - 'MAIL': '/var/mail/cltbld', 03:24:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:43 INFO - 'MOZ_NO_REMOTE': '1', 03:24:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:43 INFO - 'NO_EM_RESTART': '1', 03:24:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:43 INFO - 'PWD': '/builds/slave/test', 03:24:43 INFO - 'SHELL': '/bin/bash', 03:24:43 INFO - 'SHLVL': '1', 03:24:43 INFO - 'TERM': 'linux', 03:24:43 INFO - 'TMOUT': '86400', 03:24:43 INFO - 'USER': 'cltbld', 03:24:43 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:43 INFO - '_': '/tools/buildbot/bin/python'} 03:24:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:43 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 03:24: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 03:24: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 03:24: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 03:24: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 03:24: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 03:24: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 03:24:45 INFO - Downloading mozsystemmonitor-0.0.tar.gz 03:24:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:24:45 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 03:24:45 INFO - Installing collected packages: mozsystemmonitor 03:24:45 INFO - Running setup.py install for mozsystemmonitor 03:24:45 INFO - Successfully installed mozsystemmonitor 03:24:45 INFO - Cleaning up... 03:24:45 INFO - Return code: 0 03:24:45 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:24:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 03:24:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 03:24:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:45 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 03:24:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 03:24:46 INFO - Using env: {'DISPLAY': ':0', 03:24:46 INFO - 'HOME': '/home/cltbld', 03:24:46 INFO - 'LANG': 'en_US.UTF-8', 03:24:46 INFO - 'LANGUAGE': 'en_US:en', 03:24:46 INFO - 'LOGNAME': 'cltbld', 03:24:46 INFO - 'MAIL': '/var/mail/cltbld', 03:24:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:46 INFO - 'MOZ_NO_REMOTE': '1', 03:24:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:46 INFO - 'NO_EM_RESTART': '1', 03:24:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:46 INFO - 'PWD': '/builds/slave/test', 03:24:46 INFO - 'SHELL': '/bin/bash', 03:24:46 INFO - 'SHLVL': '1', 03:24:46 INFO - 'TERM': 'linux', 03:24:46 INFO - 'TMOUT': '86400', 03:24:46 INFO - 'USER': 'cltbld', 03:24:46 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:46 INFO - '_': '/tools/buildbot/bin/python'} 03:24:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:46 INFO - Downloading/unpacking blobuploader==1.2.4 03:24:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:24:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:24:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:24:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:24:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:24:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:24:48 INFO - Downloading blobuploader-1.2.4.tar.gz 03:24:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:24:48 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:24: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 03:24: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 03:24: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 03:24: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 03:24: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 03:24: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 03:24:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:24:48 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:24: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 03:24: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 03:24: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 03:24: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 03:24: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 03:24: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 03:24:48 INFO - Downloading docopt-0.6.1.tar.gz 03:24:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:24:49 INFO - Installing collected packages: blobuploader, requests, docopt 03:24:49 INFO - Running setup.py install for blobuploader 03:24:49 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:24:49 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:24:49 INFO - Running setup.py install for requests 03:24:49 INFO - Running setup.py install for docopt 03:24:49 INFO - Successfully installed blobuploader requests docopt 03:24:49 INFO - Cleaning up... 03:24:49 INFO - Return code: 0 03:24:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:24:49 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')]} 03:24:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:49 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')]} 03:24:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:49 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 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24:49 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 03:24:49 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 03:24:49 INFO - Using env: {'DISPLAY': ':0', 03:24:49 INFO - 'HOME': '/home/cltbld', 03:24:49 INFO - 'LANG': 'en_US.UTF-8', 03:24:49 INFO - 'LANGUAGE': 'en_US:en', 03:24:49 INFO - 'LOGNAME': 'cltbld', 03:24:49 INFO - 'MAIL': '/var/mail/cltbld', 03:24:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:49 INFO - 'MOZ_NO_REMOTE': '1', 03:24:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:49 INFO - 'NO_EM_RESTART': '1', 03:24:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:49 INFO - 'PWD': '/builds/slave/test', 03:24:49 INFO - 'SHELL': '/bin/bash', 03:24:49 INFO - 'SHLVL': '1', 03:24:49 INFO - 'TERM': 'linux', 03:24:49 INFO - 'TMOUT': '86400', 03:24:49 INFO - 'USER': 'cltbld', 03:24:49 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:49 INFO - '_': '/tools/buildbot/bin/python'} 03:24:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:24:49 INFO - Running setup.py (path:/tmp/pip-yChzSy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:24:49 INFO - Running setup.py (path:/tmp/pip-jYfptR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:24:50 INFO - Running setup.py (path:/tmp/pip-Ad5Wt5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:24:50 INFO - Running setup.py (path:/tmp/pip-37nKiF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:24:50 INFO - Running setup.py (path:/tmp/pip-LMB4Ch-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:24:50 INFO - Running setup.py (path:/tmp/pip-wY8sKQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:24:50 INFO - Running setup.py (path:/tmp/pip-zlo3Wb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:24:50 INFO - Running setup.py (path:/tmp/pip-VqxQCP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:24:50 INFO - Running setup.py (path:/tmp/pip-HXhtTG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:24:50 INFO - Running setup.py (path:/tmp/pip-bJS9AM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:24:50 INFO - Running setup.py (path:/tmp/pip-NtVhWr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:24:50 INFO - Running setup.py (path:/tmp/pip-noSyU2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:24:50 INFO - Running setup.py (path:/tmp/pip-Y4GwHo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:24:50 INFO - Running setup.py (path:/tmp/pip-815PP2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:24:50 INFO - Running setup.py (path:/tmp/pip-nfy0Wc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:24:50 INFO - Running setup.py (path:/tmp/pip-dRIL88-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:24:50 INFO - Running setup.py (path:/tmp/pip-fJx8HD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:24:51 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:24:51 INFO - Running setup.py install for manifestparser 03:24:51 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Running setup.py install for mozcrash 03:24:51 INFO - Running setup.py install for mozdebug 03:24:51 INFO - Running setup.py install for mozdevice 03:24:51 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Running setup.py install for mozfile 03:24:51 INFO - Running setup.py install for mozhttpd 03:24:51 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Running setup.py install for mozinfo 03:24:51 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Running setup.py install for mozInstall 03:24:51 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:24:51 INFO - Running setup.py install for mozleak 03:24:51 INFO - Running setup.py install for mozlog 03:24:52 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:24:52 INFO - Running setup.py install for moznetwork 03:24:52 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:24:52 INFO - Running setup.py install for mozprocess 03:24:52 INFO - Running setup.py install for mozprofile 03:24:52 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:24:52 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:24:52 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:24:52 INFO - Running setup.py install for mozrunner 03:24:52 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:24:52 INFO - Running setup.py install for mozscreenshot 03:24:52 INFO - Running setup.py install for moztest 03:24:52 INFO - Running setup.py install for mozversion 03:24:52 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:24:52 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:24:52 INFO - Cleaning up... 03:24:52 INFO - Return code: 0 03:24:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:24:52 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')]} 03:24:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:52 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')]} 03:24:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:52 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 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24:52 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 03:24:52 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 03:24:52 INFO - Using env: {'DISPLAY': ':0', 03:24:52 INFO - 'HOME': '/home/cltbld', 03:24:52 INFO - 'LANG': 'en_US.UTF-8', 03:24:52 INFO - 'LANGUAGE': 'en_US:en', 03:24:52 INFO - 'LOGNAME': 'cltbld', 03:24:52 INFO - 'MAIL': '/var/mail/cltbld', 03:24:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:52 INFO - 'MOZ_NO_REMOTE': '1', 03:24:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:52 INFO - 'NO_EM_RESTART': '1', 03:24:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:52 INFO - 'PWD': '/builds/slave/test', 03:24:52 INFO - 'SHELL': '/bin/bash', 03:24:52 INFO - 'SHLVL': '1', 03:24:52 INFO - 'TERM': 'linux', 03:24:52 INFO - 'TMOUT': '86400', 03:24:52 INFO - 'USER': 'cltbld', 03:24:52 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:52 INFO - '_': '/tools/buildbot/bin/python'} 03:24:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:24:53 INFO - Running setup.py (path:/tmp/pip-GMqiZM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:24:53 INFO - Running setup.py (path:/tmp/pip-5L1bxT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:24:53 INFO - Running setup.py (path:/tmp/pip-STKLvN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:24:53 INFO - Running setup.py (path:/tmp/pip-cbycVF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:24:53 INFO - Running setup.py (path:/tmp/pip-jtLadB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:24:53 INFO - Running setup.py (path:/tmp/pip-GpBgVw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:24:53 INFO - Running setup.py (path:/tmp/pip-QfR27a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:24:53 INFO - Running setup.py (path:/tmp/pip-Q0inI7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:24:53 INFO - Running setup.py (path:/tmp/pip-6gmR48-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:24:53 INFO - Running setup.py (path:/tmp/pip-N9WmTX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:24:53 INFO - Running setup.py (path:/tmp/pip-CgFR00-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:24:53 INFO - Running setup.py (path:/tmp/pip-6ob0wx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:24:53 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)) 03:24:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:24:53 INFO - Running setup.py (path:/tmp/pip-0PaUbK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:24:54 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)) 03:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:24:54 INFO - Running setup.py (path:/tmp/pip-zJ56R4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:24:54 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)) 03:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:24:54 INFO - Running setup.py (path:/tmp/pip-bsvY6v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:24:54 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)) 03:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:24:54 INFO - Running setup.py (path:/tmp/pip-6XUocF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:24:54 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)) 03:24:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:24:54 INFO - Running setup.py (path:/tmp/pip-o_HP2P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:24:54 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)) 03:24:54 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)) 03:24:54 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)) 03:24:54 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)) 03:24:54 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)) 03:24:54 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)) 03:24:54 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:24:54 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 03:24:54 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 03:24:54 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 03:24:54 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 03:24:54 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 03:24:54 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 03:24:56 INFO - Downloading blessings-1.6.tar.gz 03:24:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:24:56 INFO - Installing collected packages: blessings 03:24:56 INFO - Running setup.py install for blessings 03:24:56 INFO - Successfully installed blessings 03:24:56 INFO - Cleaning up... 03:24:56 INFO - Return code: 0 03:24:56 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:24:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:24:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:24:56 INFO - Reading from file tmpfile_stdout 03:24:56 INFO - Current package versions: 03:24:56 INFO - argparse == 1.2.1 03:24:56 INFO - blessings == 1.6 03:24:56 INFO - blobuploader == 1.2.4 03:24:56 INFO - docopt == 0.6.1 03:24:56 INFO - manifestparser == 1.1 03:24:56 INFO - mozInstall == 1.12 03:24:56 INFO - mozcrash == 0.17 03:24:56 INFO - mozdebug == 0.1 03:24:56 INFO - mozdevice == 0.48 03:24:56 INFO - mozfile == 1.2 03:24:56 INFO - mozhttpd == 0.7 03:24:56 INFO - mozinfo == 0.9 03:24:56 INFO - mozleak == 0.1 03:24:56 INFO - mozlog == 3.1 03:24:56 INFO - moznetwork == 0.27 03:24:56 INFO - mozprocess == 0.22 03:24:56 INFO - mozprofile == 0.28 03:24:56 INFO - mozrunner == 6.11 03:24:56 INFO - mozscreenshot == 0.1 03:24:56 INFO - mozsystemmonitor == 0.0 03:24:56 INFO - moztest == 0.7 03:24:56 INFO - mozversion == 1.4 03:24:56 INFO - psutil == 3.1.1 03:24:56 INFO - requests == 1.2.3 03:24:56 INFO - wsgiref == 0.1.2 03:24:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:24:56 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')]} 03:24:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:56 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')]} 03:24:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:56 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 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24:56 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 03:24:56 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 03:24:56 INFO - Using env: {'DISPLAY': ':0', 03:24:56 INFO - 'HOME': '/home/cltbld', 03:24:56 INFO - 'LANG': 'en_US.UTF-8', 03:24:56 INFO - 'LANGUAGE': 'en_US:en', 03:24:56 INFO - 'LOGNAME': 'cltbld', 03:24:56 INFO - 'MAIL': '/var/mail/cltbld', 03:24:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:56 INFO - 'MOZ_NO_REMOTE': '1', 03:24:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:56 INFO - 'NO_EM_RESTART': '1', 03:24:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:56 INFO - 'PWD': '/builds/slave/test', 03:24:56 INFO - 'SHELL': '/bin/bash', 03:24:56 INFO - 'SHLVL': '1', 03:24:56 INFO - 'TERM': 'linux', 03:24:56 INFO - 'TMOUT': '86400', 03:24:56 INFO - 'USER': 'cltbld', 03:24:56 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:56 INFO - '_': '/tools/buildbot/bin/python'} 03:24:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 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)) 03:24:56 INFO - Cleaning up... 03:24:56 INFO - Return code: 0 03:24:56 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:24:56 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')]} 03:24:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:56 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')]} 03:24:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:56 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 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24:56 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 03:24:56 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 03:24:56 INFO - Using env: {'DISPLAY': ':0', 03:24:56 INFO - 'HOME': '/home/cltbld', 03:24:56 INFO - 'LANG': 'en_US.UTF-8', 03:24:56 INFO - 'LANGUAGE': 'en_US:en', 03:24:56 INFO - 'LOGNAME': 'cltbld', 03:24:56 INFO - 'MAIL': '/var/mail/cltbld', 03:24:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:56 INFO - 'MOZ_NO_REMOTE': '1', 03:24:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:56 INFO - 'NO_EM_RESTART': '1', 03:24:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:56 INFO - 'PWD': '/builds/slave/test', 03:24:56 INFO - 'SHELL': '/bin/bash', 03:24:56 INFO - 'SHLVL': '1', 03:24:56 INFO - 'TERM': 'linux', 03:24:56 INFO - 'TMOUT': '86400', 03:24:56 INFO - 'USER': 'cltbld', 03:24:56 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:56 INFO - '_': '/tools/buildbot/bin/python'} 03:24:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:57 INFO - Downloading/unpacking jsonschema 03:24:57 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 03:24:57 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 03:24:57 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 03:24:57 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 03:24:57 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 03:24:57 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 03:24:58 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:24:58 INFO - Downloading/unpacking functools32 (from jsonschema) 03:24:58 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 03:24:58 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 03:24:58 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 03:24:58 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 03:24:58 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 03:24:58 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 03:24:59 INFO - Downloading functools32-3.2.3-2.tar.gz 03:24:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:24:59 INFO - warning: no files found matching '*.txt' 03:24:59 INFO - no previously-included directories found matching 'build' 03:24:59 INFO - no previously-included directories found matching 'dist' 03:24:59 INFO - no previously-included directories found matching '.git*' 03:24:59 INFO - Installing collected packages: jsonschema, functools32 03:24:59 INFO - Running setup.py install for functools32 03:24:59 INFO - warning: no files found matching '*.txt' 03:24:59 INFO - no previously-included directories found matching 'build' 03:24:59 INFO - no previously-included directories found matching 'dist' 03:24:59 INFO - no previously-included directories found matching '.git*' 03:24:59 INFO - Successfully installed jsonschema functools32 03:24:59 INFO - Cleaning up... 03:24:59 INFO - Return code: 0 03:24:59 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 03:24:59 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')]} 03:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:24:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:59 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')]} 03:24:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:24:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:24:59 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 0x7fe219462f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23f35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, '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': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', '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 03:24:59 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 03:24:59 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 03:24:59 INFO - Using env: {'DISPLAY': ':0', 03:24:59 INFO - 'HOME': '/home/cltbld', 03:24:59 INFO - 'LANG': 'en_US.UTF-8', 03:24:59 INFO - 'LANGUAGE': 'en_US:en', 03:24:59 INFO - 'LOGNAME': 'cltbld', 03:24:59 INFO - 'MAIL': '/var/mail/cltbld', 03:24:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:24:59 INFO - 'MOZ_NO_REMOTE': '1', 03:24:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:24:59 INFO - 'NO_EM_RESTART': '1', 03:24:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:24:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:24:59 INFO - 'PWD': '/builds/slave/test', 03:24:59 INFO - 'SHELL': '/bin/bash', 03:24:59 INFO - 'SHLVL': '1', 03:24:59 INFO - 'TERM': 'linux', 03:24:59 INFO - 'TMOUT': '86400', 03:24:59 INFO - 'USER': 'cltbld', 03:24:59 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:24:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:24:59 INFO - '_': '/tools/buildbot/bin/python'} 03:24:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:24:59 INFO - Downloading/unpacking flake8 03:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:24:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:24:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:24:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:24:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:25:01 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 03:25:01 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 03:25:01 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 03:25:01 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 03:25:01 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 03:25:01 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 03:25:01 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 03:25:01 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 03:25:01 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 03:25:01 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 03:25:01 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 03:25:01 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 03:25:01 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 03:25:01 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 03:25:01 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 03:25:01 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 03:25:02 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 03:25:02 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 03:25:02 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 03:25:02 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 03:25:02 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 03:25:02 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 03:25:02 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 03:25:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 03:25:02 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:25:02 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:25:02 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:25:02 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:25:02 INFO - no previously-included directories found matching 'docs/_build' 03:25:02 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 03:25:02 INFO - Running setup.py install for pep8 03:25:02 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:25:02 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:25:02 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:25:02 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:25:02 INFO - no previously-included directories found matching 'docs/_build' 03:25:02 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 03:25:02 INFO - Successfully installed flake8 mccabe pyflakes pep8 03:25:02 INFO - Cleaning up... 03:25:02 INFO - Return code: 0 03:25:02 INFO - Running post-action listener: _resource_record_post_action 03:25:02 INFO - Running post-action listener: _start_resource_monitoring 03:25:02 INFO - Starting resource monitoring. 03:25:02 INFO - ##### 03:25:02 INFO - ##### Running install step. 03:25:02 INFO - ##### 03:25:02 INFO - Running pre-action listener: _resource_record_pre_action 03:25:02 INFO - Running main action method: install 03:25:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:25:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:25:02 INFO - Reading from file tmpfile_stdout 03:25:02 INFO - Detecting whether we're running mozinstall >=1.0... 03:25:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:25:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:25:02 INFO - Reading from file tmpfile_stdout 03:25:02 INFO - Output received: 03:25:02 INFO - Usage: mozinstall [options] installer 03:25:02 INFO - Options: 03:25:02 INFO - -h, --help show this help message and exit 03:25:02 INFO - -d DEST, --destination=DEST 03:25:02 INFO - Directory to install application into. [default: 03:25:02 INFO - "/builds/slave/test"] 03:25:02 INFO - --app=APP Application being installed. [default: firefox] 03:25:02 INFO - mkdir: /builds/slave/test/build/application 03:25:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 03:25:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 03:25:18 INFO - Reading from file tmpfile_stdout 03:25:18 INFO - Output received: 03:25:18 INFO - /builds/slave/test/build/application/firefox/firefox 03:25:18 INFO - Running post-action listener: _resource_record_post_action 03:25:18 INFO - ##### 03:25:18 INFO - ##### Running run-tests step. 03:25:18 INFO - ##### 03:25:18 INFO - Running pre-action listener: _resource_record_pre_action 03:25:18 INFO - Running main action method: run_tests 03:25:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:25:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:25:18 INFO - Python 2.7.3 03:25:18 INFO - Return code: 0 03:25:18 INFO - grabbing minidump binary from tooltool 03:25:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:25:18 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 0x2482410>, '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 0x2483310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24837a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:25:18 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 03:25:18 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 03:25:18 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:25:18 INFO - Return code: 0 03:25:18 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:25:18 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:25:18 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:25:18 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:25:18 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:25:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 03:25:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 03:25:19 INFO - Return code: 0 03:25:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-012', '--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 03:25:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-012 --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 03:25:19 INFO - Using env: {'DISPLAY': ':0', 03:25:19 INFO - 'HOME': '/home/cltbld', 03:25:19 INFO - 'LANG': 'en_US.UTF-8', 03:25:19 INFO - 'LANGUAGE': 'en_US:en', 03:25:19 INFO - 'LOGNAME': 'cltbld', 03:25:19 INFO - 'MAIL': '/var/mail/cltbld', 03:25:19 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:25:19 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:25:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:25:19 INFO - 'MOZ_NO_REMOTE': '1', 03:25:19 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:25:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:25:19 INFO - 'NO_EM_RESTART': '1', 03:25:19 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:25:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:25:19 INFO - 'PWD': '/builds/slave/test', 03:25:19 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:25:19 INFO - 'SHELL': '/bin/bash', 03:25:19 INFO - 'SHLVL': '1', 03:25:19 INFO - 'TERM': 'linux', 03:25:19 INFO - 'TMOUT': '86400', 03:25:19 INFO - 'USER': 'cltbld', 03:25:19 INFO - 'XDG_SESSION_COOKIE': '2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931', 03:25:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:25:19 INFO - '_': '/tools/buildbot/bin/python'} 03:25:19 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-012', '--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 03:25:19 INFO - mozversion application_buildid: 20160603004101 03:25:19 INFO - mozversion application_changeset: effbb9ad4e93c4383e484f3a515d23194d3c6329 03:25:19 INFO - mozversion application_display_name: FirefoxDeveloperEdition 03:25:19 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:25:19 INFO - mozversion application_name: Firefox 03:25:19 INFO - mozversion application_remotingname: firefox-dev 03:25:19 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:25:19 INFO - mozversion application_vendor: Mozilla 03:25:19 INFO - mozversion application_version: 48.0a2 03:25:19 INFO - mozversion platform_buildid: 20160603004101 03:25:19 INFO - mozversion platform_changeset: effbb9ad4e93c4383e484f3a515d23194d3c6329 03:25:19 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:25:19 INFO - mozversion platform_version: 48.0a2 03:25:19 INFO - using testdate: 1464949519 03:25:19 INFO - actual date: 1464949519 03:25:19 INFO - starting webserver on 'localhost:50078' 03:25:19 INFO - SUITE-START | Running 2 tests 03:25:19 INFO - TEST-START | dromaeo_css 03:25:19 INFO - operating with platform_type : linux_ 03:25:19 INFO - Initialising browser for dromaeo_css test... 03:25:19 INFO - TEST-INFO | started process 31300 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpz8vujj/profile http://localhost:50078/getInfo.html) 03:25:23 INFO - PROCESS | 31300 | 03:25:23 INFO - PROCESS | 31300 | (process:31381): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:25:23 INFO - PROCESS | 31300 | __metrics Screen width/height:1600/1200 03:25:23 INFO - PROCESS | 31300 | colorDepth:24 03:25:23 INFO - PROCESS | 31300 | Browser inner width/height: 1024/697 03:25:23 INFO - PROCESS | 31300 | __metrics 03:25:24 ERROR - PROCESS | 31300 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2940: TypeError: this.tabs is undefined 03:25:25 INFO - TEST-INFO | 31300: exit 0 03:25:25 INFO - Browser initialized. 03:25:25 INFO - Running cycle 1/1 for dromaeo_css test... 03:25:25 INFO - TEST-INFO | started process 31432 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpz8vujj/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:25:26 INFO - PROCESS | 31432 | 03:25:26 INFO - PROCESS | 31432 | (process:31498): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:25:36 INFO - PROCESS | 31432 | RSS: Main: 152215552 03:25:36 INFO - PROCESS | 31432 | 03:26:26 INFO - PROCESS | 31432 | 1464949586493 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] 03:28:33 INFO - PROCESS | 31432 | Cycle 1(1): loaded http://localhost:50078/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50078/tests/dromaeo/cssquery-ext.html) 03:28:34 INFO - PROCESS | 31432 | RSS: Main: 155353088 03:28:34 INFO - PROCESS | 31432 | 03:31:36 INFO - PROCESS | 31432 | Cycle 1(1): loaded http://localhost:50078/tests/dromaeo/cssquery-ext.html (next: http://localhost:50078/tests/dromaeo/cssquery-jquery.html) 03:31:37 INFO - PROCESS | 31432 | RSS: Main: 154116096 03:31:37 INFO - PROCESS | 31432 | 03:34:39 INFO - PROCESS | 31432 | Cycle 1(1): loaded http://localhost:50078/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50078/tests/dromaeo/cssquery-mootools.html) 03:34:39 INFO - PROCESS | 31432 | RSS: Main: 153759744 03:34:39 INFO - PROCESS | 31432 | 03:37:41 INFO - PROCESS | 31432 | Cycle 1(1): loaded http://localhost:50078/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50078/tests/dromaeo/cssquery-prototype.html) 03:37:42 INFO - PROCESS | 31432 | RSS: Main: 153206784 03:37:42 INFO - PROCESS | 31432 | 03:40:44 INFO - PROCESS | 31432 | Cycle 1(1): loaded http://localhost:50078/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50078/tests/dromaeo/cssquery-yui.html) 03:40:45 INFO - PROCESS | 31432 | RSS: Main: 155000832 03:40:45 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | Cycle 1(1): loaded http://localhost:50078/tests/dromaeo/cssquery-yui.html (next: http://localhost:50078/tests/dromaeo/cssquery-dojo.html) 03:43:47 INFO - PROCESS | 31432 | RSS: Main: 156061696 03:43:47 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | __start_tp_report 03:43:47 INFO - PROCESS | 31432 | _x_x_mozilla_page_load 03:43:47 INFO - PROCESS | 31432 | _x_x_mozilla_page_load_details 03:43:47 INFO - PROCESS | 31432 | |i|pagename|runs| 03:43:47 INFO - PROCESS | 31432 | |0;dojo.html;3332.6334103248646;3384.035549868288;3391.220019395539;3427.605825330088;3442.087846720618;5503.532199763025;5510.8071217507395;5511.834644960658;5541.279633647625;5550.555955523559;5491.395946445888;5549.250851135095;5559.861003474915;5564;5587.720613969295;5090.465501122384;5092.872678183038;5149.0731668299695;5158.226266060084;5166.380034395877;5037.06814239365;5136.820211292606;5210.713410762407;5254.600768041498;5280.419153893069;5002.9499705002845;5067.49325067494;5102.617303702219;5134.897302053957;5186.636935414523;5077.390713114413;5092.414372347191;5101.897962040757;5103.566196873233;5155.896882062375;4782.426108866924;5076;5084.491550844923;5103.2855400244;5131.923021154686;5490.752916118784;5529.30883639545;5547.833564993057;5577.274954255961;5614.719264036782;5822.854428639275;5844;5845.152452894349;5851.912221316684;5890.352061273256;5727.856803579903;5895.882082358329;5929.495992840613;5943.257092863392;6072.848178795565;5638.238837756932;5648.3222013358245;5672.035753921843;5676.971615141939;5689.345725241609;6095.512359011268;6115.449609535163;6127.84680382994;6148.231471066117;6149.0776383542825;5761.452661997104;5883.558733095035;5897.056470964625;5937.970310148508;5978.85052873673;5945.286565612154;5949.970250148722;5956.76172953077;5962.791302304398;5964.582479226413;5882.882342353215;5888.587798854125;5918.615290006222;5935.317438494542;5958.285005799332;5770;5865.472107510344;5920.5559583031445;5923.200367950358;5973.98442264816;4503.279475283939;4503.954960450419;4515.480719717275;4518.661100417482;4533.274676051816;4072.735272207297;4082.3264161413626;4089.2026054919006;4100.17996400721;4110.7328023678965;5593.74828132735;5610.691411972299;5784.1902133701315;5853.824385268449;5874.941250587525;5911.231539899785;6008.369121242206;6053.909191362133;6065.363136870653;6078.270607527125;5793.565482588822;5804.2744656917885;5808.361080281165;5819.73811178498;5820.767169313265;4911.140550403665;5023.598112151019;5032.6980381177245;5105.412877519058;5189.40321862983;6214.130021796952;6235.469985051322;6250.9062364064575;6261.342559031327;6276.309605943343;6012.8797424052145;6037.849053773691;6041.033434650435;6042.115039872832;6058.848528786815;5978.551608629283;6144.525313924715;6207.410296021871;6231.719572619334;6237.1891654084675;5862.149988251765;5898.970505147447;5903.527717782653;5906;5926.555508336805;5999.850003749942;6012.458878700938;6015.398460154124;6026.487748541248;6029.095635654687;5675.602707810413;5797.362290147996;5813.883722325614;5818.2436283282905;5863.2670916135485;5859.20900678403;5885.14665373527;5890.087036509348;5916.911246331222;5923.437273459014;5516.089845175501;5825.097109947965;5827;5840.123981402823;5850.151727999331;5882.088276317178;5925.644461332334;5934.406559344204;5955.136505206808;5960.254968128984;5744.597878148489;5763.740631671669;5767.452092051416;5774.8845023098465;5784.363719990713 03:43:47 INFO - PROCESS | 31432 | |1;ext.html;647.4237928243863;664.8637029408972;668.6760214774746;676.7191615479576;773.0761739721029;38502.61497385025;39204.60795392049;39231;39361.80319098404;39455.40816887749;40436.19127617446;40890.79554602223;41164.38253426201;41201;41418;8550.572471376438;8705.608247628872;8729.127087291283;8730.607122679463;8754.912450875505;8787.725779761931;8942.15049570293;8982.685606003792;8987;8994.955025224865;8943.373963822534;8952.955235223815;9002.369834111614;9008.504532250723;9008.504532250723;8935.195832375084;8948.597313120892;8960.327975401839;8971.147740964598;8989.46063236208;8815.867761983576;8910.331725120643;8934.955325223398;8937.46375217489;8939.597718102701;33549.32901341984;41834.790826045675;42323.36514952278;42595.78702106501;42648.78675606633;3313.6023677158896;3649.981750091259;3766.0020094674933;3992.3412636914873;4431.512533621299;29475;29973.25066873324;30187.396252075054;30422.84788576065;30884.84557577198;4194.790260486963;4252.170826688797;4291.163223171483;4292.2668782386445;4310.245707001262;249817;250552;251865;252199;252410;37087.81456092702;37448.43827342592;37488.81255593759;37512;37512.43731344032;69184.65407672929;69305;69604;69759.30240697529;70190.64904675444;19033.333833316043;19048.238070477026;19066;19085.522861928563;19223.32718354851;13847.030707850556;13943.721125577635;13946.372413241428;13971.86028139726;14001.579952601438;20719;21310.147594096063;21313.78686213118;21387.786122138892;21546.78453215479;7535.208803075708;7822.569758663214;7885.329746971457;7888.675144277589;7940.205979402013;1124.6907100547414;1127.4685103508477;1190.9460127786797;1216.3614102596207;1233.7655845389527;32956.3408731824;33357.66642333594;33601.66398336034;33880;34033.31933361319;1224.455117472716;1227.533537255837;1312.1864444044754;1330.7272009238084;1333.2134040915905;17400.955942643483;17556.648867022588;17584.296628134987;17589.384371546934;17707.468775936486;462306;500678;519290;523554;524991;57822.421775782546;58910;58960;59044.40955590475;59152.40847591555;1536.9001014933995;1538.369268599891;1564.1788061267698;1566.7258229809738;1650.6038550747974;30373.544396833622;30807.84596077095;30952.535711963887;31033;31530;55063;55679.721601391735;56028.71985640046;56123.43876561182;56364.154537682785;429723;430862;432130;432878;433464;31332.37335253328;31464.685353146175;31558;31849.522257165696;31859.36281274408;51554;52166.21750673819;52272.21591676204;52761.7361913188;52966;42514.78742606267;43468.782656086514;43494;44247.557524424345;45074.77462612666;42928.35607465828;43538.34692479679;43738.12523749444;44543.777281113384;44814;42197.15605687808;43429.56570434382;43829.123417530835;44311.55688443203;44468.777656112805;37119.814400927826;37923;37994.43008354821;38545;38824;28698.282542936595;29776.362300073702;30030.849845750632;30051;30082 03:43:47 INFO - PROCESS | 31432 | |2;jquery.html;425.6148185891769;432.976186309753;435.8547348550364;436.5699785711074;441.63344424127956;18432.723509147356;19136.330228442006;19141.712874306897;19193.232270709188;20220.59558808823;12555.811662825065;12714;13106.737865242689;19821;20247.898760506177;5096.949030509694;5249.606279529032;5272.393674727398;5279.41926388097;5283.392409872856;5267.499587539197;5766.913496297559;5772.249607551013;5816.040353341694;5834.766609335643;5719.999000174974;5751.338596061444;5755.884882302373;5760.366359700451;5769.740361683714;5550.361708403545;5772.0187568113315;5774.82675519735;5784.623999440023;5802.332731735841;5164.974175129138;5166.43169251382;5219.634625576211;5223.921641175385;5226.947730522684;13375;19485.220591176338;23326.183583574664;23597.528049438915;24099.87950060256;2360.1621424394266;2431.841930274544;2462.0890270599994;2501.137107697841;2639.4325220077776;9970.075900200143;10575;10693.9465302673;13044.608661740163;14841.70316593662;1986.8112529309692;2108.2621082621113;2132.5734853029303;2207.4922767763505;2271.4207876991427;75518;85391.57304213502;85476.57261713651;85722.57138714267;96037;18061.458156255332;18656;18669.533261668566;18815.435536933914;18962.43112706621;34599.13502162466;34700.47949280763;34814.30371392558;35084.29831403409;35186.824065879504;10132.746681332877;10481.895181048245;10560.155187584975;10830.512626931806;10884.510197041152;8704.738857834274;8847.292216622654;8847.51338676379;8913.37606367561;8942.105789421135;9568.186704130088;9691.951540242395;9769.658061967939;9808.901910980941;9859.901400986042;3615.6203598621764;3683.7659384106623;3811.5415556965604;3911.9804400977814;3938.448617193595;972.3290929258789;1062.5484169228048;1073.1682945717132;1132.8640563132476;1142.4573327669457;18414.079296035146;19540.70688939667;19550.413487595393;19660.50848728793;19908;1103.968628229636;1116.17403121691;1116.5143162724241;1125.1954852280658;1139.800534906388;10950.835737463944;11090.944545277222;11135.832962505569;11156.776864462827;11168.329900206014;466890;491243;495122;495202;496222;89244;90102;90291.54854225687;91689.08310916938;92303.53848230717;1109.8890110988998;1117.3631030312645;1121.5401685308984;1138.0269869261826;1146.094585277638;17284.395046173322;17507.82492175062;17849.464516064538;17859.107044647975;17994.820051799838;39455.408168876915;40163.19673606453;40227.79886100551;40766.18467630571;40868.386974194815;53034.4696553045;56064;56450.71774641265;56576;56610.43389566051;9001.819963600561;9082.273418126402;9179.449233046038;9321.533923303672;9372.015938326378;11311.717207069889;13056.543020994219;13120.475180992653;13756.862431375559;14098;11806.173567850168;12259;12379.876201238232;12439;12440.440180191732;11461.312321260752;11749.236299640495;11873.168878178445;11901.464434100659;12359.3820308986;11691.415429228335;12038.518459261883;12072.396380181131;12221.511139554319;12536.498540058295;8806.779830504289;8855.55722213874;8888.73333799987;9040;9073.228775554151;10420.42687652156;12374.938125309676;12422.192557483735;12487.250764954131;12573.87426125727 03:43:47 INFO - PROCESS | 31432 | |3;mootools.html;1539.7844301797747;1559.9142047187406;1773.654137443199;1878;1893.6875415556433;7356.963215183917;7958.641861116249;8083.676652933883;8240.299574536164;8310.999999999993;7174.6412679366085;7948.244916732916;8058.39562032847;8097.91902080979;8226.42415030948;2303.9539209215804;2316.5482730867448;2342.9882850585723;2343.5781559319316;2350.635651474024;2300.275413244831;2310.560993411255;2326.1974618756503;2326.232343326698;2336.7429582745885;2289.3589794857385;2304.5736538740302;2309.722833260011;2310.1914329984456;2312.838101332907;2325.9651105233434;2334.661474086265;2343.379004563792;2351.8588884666888;2354.211339201361;2263.932082037525;2280.5210905709655;2281.2243837095466;2283.817294616427;2285.42864283929;8286.295664868494;8320;8325.583720813935;8347.707830225974;8350.457220280723;5028.949710502921;5092.363454568179;5104.157813960692;5107.182850743863;5125.256837758541;3206.9679303206904;3230.3216324571868;3276.1973316537365;3337.0823023668445;3376.1390845334527;1090.3294473898495;1102.8345748137845;1110.7167672243527;1115.3921112993437;1128.8871112888646;10946.56213751449;10975.83536246949;11034.834477482844;11068.667939961813;11071.667849964433;4293.098449325614;4347.0871117065135;4401.449818772653;4404.339349097597;4428.535003824616;9456.196223321094;9532.761680958032;9540.045995400404;9544.475053872104;9552.283578731623;5069.898602027939;5094.719790411563;5107.387113546398;5120.846374608767;5130.076586214517;4045.3527435610163;4554.4990051094355;4611.9077618447445;4650.558196971282;4694.319323698113;3921.6078392160557;3949.7037722170953;3980.0845805464905;4035.0315924177985;4077.062275676611;1283.595667364777;1289.8774616411426;1315.6776589735575;1324.6953200763878;1336.0313772515044;1059.2426415113232;1067.0876400677464;1073.9409332486632;1080.4813689429118;1084.739662480999;5740.225069615632;5791.957447659377;5917.142014407887;5921.815636872643;5957;450.1559575795384;456.25630222736726;464.02786162988485;464.305862735213;466.61970494047245;3723.4042553191903;3733.197362567061;3796.3166630006313;3801.7718936863325;3899.2201559688174;10057.346272492265;10402.375857448576;10488.842667359995;10509.84235236472;10521.263511554118;10244.692659220234;10259.435731034864;10287;10299.124574411258;10322.12261957727;7941.245581669732;8107.554084525408;8109.472884262504;8131.918680813116;8137.796555086052;5682.9147562785765;5708.914366284592;5726.742296596746;5742.454466825645;5788.884222315614;8715.869261960948;8895.777605559653;8899.688510902088;8966.148215919477;8998;8868.733937981871;8879.511626860585;8993.28053755685;9001.819963600561;9082.228010619172;7024.5434046786795;7422.517536360119;7689.807754806175;7859.960700196462;7975.401844861774;7837.529748215125;7860.096088949844;7908.52548847071;7910.683572657029;7938.841223175619;6953.269906659728;7108.46686498525;7166.89249661266;7312.5246858954;7389.261073892782;7198.49610527279;7260.528065675714;7275.308845659654;7299.648011789272;7310.451716121206;6748.561343512656;6773.288804675635;6790.117284752951;6809.250982392032;6831.829204269933;4883;5078.238264260391;5086.669366491166;5118.181091025418;5147.40804807452;4908.607311415007;4974.253861920596;4980.825671101494;5010.398752149766;5032.874178145576 03:43:47 INFO - PROCESS | 31432 | |4;prototype.html;322.3681584095173;325.8126577218097;331.4067818604698;357.3852972886634;357.9409397449421;6474.125992990945;6624.801255962323;6675.899861502081;6690.565113267634;6844.486663500233;6622.47020238381;6679.565828221174;6694;6696.06255124283;6706.329367063291;4924.876878078041;4925.82759603414;4929.137400954827;4933.8519844404545;4934.97532512337;4874.8537543873745;5020.297158397827;5029.899402011957;5038.496150384951;5047.293378926953;4954.033963377143;4965.42897566779;4967.552920237178;4970.304157417964;4988.102141614526;4941.901161976776;4974;4980.228064649967;4986.551210391046;4993.6005119590345;4342.717723347972;4343.457067866517;4347.456567929009;4350.782460876975;4352.412424322739;6371;6373.362663733589;6380.298167201604;6383.904241436382;6384.840378990516;5507.586930980193;5698.259226300595;5726.656400615976;5773.797917072882;5799.623024503436;6973.198082220559;6998.090248267693;7000.334968178015;7002.229754726976;7014.123234595676;4663.88340291492;4676.298555216711;4680.4149481314835;4691.460482044575;4696.7651617419;7286.526375785557;7328.413726901835;7363.042804435443;7384.593847338394;7386.3352298292875;4901.044296362246;4901.852944411673;4905.141600219948;4905.9018819624125;4910.410750709938;4793.592544633675;4943.777530011158;4962.255661650781;4977.527134922177;4987.950120498821;5760.711964401763;5783.306003279633;5787.450192231731;5793.391693872167;5796.21751063601;7027.051348068047;7033;7061;7061.858762824818;7080;1687.9746803797952;1688.9915550422415;1691.4502786594405;1692.2892385198247;1705.4457301376854;1106.6126855600637;1123.6797512709002;1132.7111586545377;1135.858462245438;1141.3437273567731;6841.521093523405;6867.553609015398;6882.03651488792;6883.931160688429;6904.689288982008;7236.565806051549;7249.383802376751;7262.20115787263;7267.491275610762;7305.452091093083;6594.934050659432;6696.966515167393;6860.245373008965;6864.759733409307;6897.7240910363025;3945.2109578084496;3970.7617542947514;3974.4833171687496;3977.2244412339314;3986.760794352348;7672.347850432776;7677.424193185422;7680.078390593053;7694.192109828499;7694.499857509244;7522.774316770506;7527.623618819037;7532.736354227685;7539.283768042027;7540.547567145989;7380.667869945865;7656.961715191388;7665.731699390494;7718.845623087619;7722.53664780115;7362.595057271901;7379.298966598165;7396.3343299103335;7400.185979542353;7414.406847452083;7258.963705181652;7277.8180545484665;7304.415646748141;7310.561366318038;7313;7672.6547305372505;7695.23047695226;7711;7711.614419279126;7724.7682569523;4638.953610463987;4782.187028205144;4814.470408255019;4825.059113472839;4855.757212139309;7174.892376614251;7174.892376614459;7218.639068046472;7256.129264488295;7281.708731650675;6941.687624057031;6995.440364770908;7056.54132481387;7060.435165186876;7063.117110361205;7044.894326585208;7050.929490705027;7089.0784198053925;7104.857902842017;7135.82160445993;6808.28513006147;6910.101686780687;6919.515633905779;6922.688479018356;6948.652567371712;7048.929510704827;7079.610621415665;7081.610511421921;7085.362317391253;7089.291070892869;6916.412104971134;6920.134983127109;6923.09999700056;6924.861502770017;6926.515143939876 03:43:47 INFO - PROCESS | 31432 | |5;yui.html;841.6170642357728;869.8695195720641;918.9448633082013;925.4262357338449;925.8240934222493;14710.852891471082;14719.190444525548;14985.32566034527;15002.324895379707;15005.84994150058;13930.303484825768;13964.650883727913;13970.091944023632;13997.720045599082;14017.64955876101;748.4985060009807;884.2528063786091;890.2032680750724;902.9638814447414;906.0939060939061;913.4336711239008;915.7390143809016;916.9770755731093;917.0600134861787;917.2661870503604;964.9758756031121;972.5915115651443;973.304087577382;973.4937832327186;976.653288082731;965.9420434773901;966.8791401074866;968.3028219681853;969.762408209986;970.3159272712755;712.0885266858429;715.0882624653557;715.9033530473372;717.046328383249;719.3238355945394;14260.928695356457;14398.496052638213;14466.855331446655;14472.638184045483;14508.492202772957;15304.387824487007;15358.462453814174;15388.846111538853;15497.45758898433;15701.293441795147;12020.819687704692;12140.089493287951;12178.51285948561;12337.814932776015;12462.563810266598;4010.177913527749;4012.277789997799;4088.2641124597562;4093.4269202311702;4179.540250572434;54846;55032.724836375965;55091;55149;55671.72164139194;11470.770584588428;11695.590654327058;11701.239419437708;11738.94130529342;11747.353895535656;21504.677429838564;21723.782762172494;21729.239476618244;21775;21811.67282490764;8163.959180204061;8296.045954715284;8320.625571849281;8435.409521333448;8634.697785577475;4499.6400287976885;4557.72653640776;4928.088303663833;4975.5522003019905;5095.031943930641;3320.634730179678;3321.80069195849;3326.8003919764406;3330.733541316689;3362.7814192077435;571.5341996273107;573.6357413042665;578.6585914310577;579.1023912934934;583.0350769476523;690.5545922879814;722.2777222777223;796.7928338631997;815.6655771133925;816.1063635319316;8743.606537705818;8845.159709827556;9088.10598977497;9196.12636799503;9197;669.9782831182389;736.3262614707589;820.4502983001404;837.4221786966973;839.588601585231;4331.761753103547;4451.243288640939;4463.129689710475;4486.528914463935;4575.816967321336;62801;63393;63637.681811591574;63739.6813015932;64345.67827160834;54001.189982150296;58648.4135158643;59222;59666.40333596608;60279.397206028254;49405.25892111621;49711.75144124329;50330.24504632434;50681;51141;9845.45849978258;9999.700008999742;10013.349132306377;10350.223733219887;10425.582976681151;38049;38676.41985370166;38870.2225955485;39001;40054;43678.68963931087;43867.78066109649;46607.53392466032;49450.75274623604;50204;11683.474243659226;12084;12108.273503589813;12176.39118044112;12195.878041219474;13816.309184540532;13964.790528141883;14394.064385814889;14434.639134021734;15005.924970375077;13376.398062087424;13623.591292261248;13628.523001694894;13678.794818077538;14073.366698498387;13036.934815325863;13057.542985995444;13471.797923031358;14148.22184779847;14213.857861421253;13090;13382.598522044354;13529.59411217665;13592.66018349549;13920.721585568435;11417.200795944203;11517.42412879336;11651.650450486499;11668.968532337154;11831.881681183078;11460.140489463156;11524.308541487537;11534.769304613694;11547.4803633835;11647.708807279885 03:43:47 INFO - PROCESS | 31432 | __end_tp_report 03:43:47 INFO - PROCESS | 31432 | __start_cc_report 03:43:47 INFO - PROCESS | 31432 | _x_x_mozilla_cycle_collect,328 03:43:47 INFO - PROCESS | 31432 | __end_cc_report 03:43:47 INFO - PROCESS | 31432 | __startTimestamp1464950627429__endTimestamp 03:43:47 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | ------- Summary: start ------- 03:43:47 INFO - PROCESS | 31432 | Number of tests: 6 03:43:47 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | [#0] dojo.html Cycles:165 Average:5561.98 Median:5813.88 stddev:616.47 (10.6%) stddev-sans-first:593.04 03:43:47 INFO - PROCESS | 31432 | Values: 3332.6 3384.0 3391.2 3427.6 3442.1 5503.5 5510.8 5511.8 5541.3 5550.6 5491.4 5549.3 5559.9 5564.0 5587.7 5090.5 5092.9 5149.1 5158.2 5166.4 5037.1 5136.8 5210.7 5254.6 5280.4 5002.9 5067.5 5102.6 5134.9 5186.6 5077.4 5092.4 5101.9 5103.6 5155.9 4782.4 5076.0 5084.5 5103.3 5131.9 5490.8 5529.3 5547.8 5577.3 5614.7 5822.9 5844.0 5845.2 5851.9 5890.4 5727.9 5895.9 5929.5 5943.3 6072.8 5638.2 5648.3 5672.0 5677.0 5689.3 6095.5 6115.4 6127.8 6148.2 6149.1 5761.5 5883.6 5897.1 5938.0 5978.9 5945.3 5950.0 5956.8 5962.8 5964.6 5882.9 5888.6 5918.6 5935.3 5958.3 5770.0 5865.5 5920.6 5923.2 5974.0 4503.3 4504.0 4515.5 4518.7 4533.3 4072.7 4082.3 4089.2 4100.2 4110.7 5593.7 5610.7 5784.2 5853.8 5874.9 5911.2 6008.4 6053.9 6065.4 6078.3 5793.6 5804.3 5808.4 5819.7 5820.8 4911.1 5023.6 5032.7 5105.4 5189.4 6214.1 6235.5 6250.9 6261.3 6276.3 6012.9 6037.8 6041.0 6042.1 6058.8 5978.6 6144.5 6207.4 6231.7 6237.2 5862.1 5899.0 5903.5 5906.0 5926.6 5999.9 6012.5 6015.4 6026.5 6029.1 5675.6 5797.4 5813.9 5818.2 5863.3 5859.2 5885.1 5890.1 5916.9 5923.4 5516.1 5825.1 5827.0 5840.1 5850.2 5882.1 5925.6 5934.4 5955.1 5960.3 5744.6 5763.7 5767.5 5774.9 5784.4 03:43:47 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | [#1] ext.html Cycles:180 Average:56847.54 Median:23014.79 stddev:108879.56 (473.1%) stddev-sans-first:109103.23 03:43:47 INFO - PROCESS | 31432 | Values: 647.4 664.9 668.7 676.7 773.1 38502.6 39204.6 39231.0 39361.8 39455.4 40436.2 40890.8 41164.4 41201.0 41418.0 8550.6 8705.6 8729.1 8730.6 8754.9 8787.7 8942.2 8982.7 8987.0 8995.0 8943.4 8953.0 9002.4 9008.5 9008.5 8935.2 8948.6 8960.3 8971.1 8989.5 8815.9 8910.3 8935.0 8937.5 8939.6 33549.3 41834.8 42323.4 42595.8 42648.8 3313.6 3650.0 3766.0 3992.3 4431.5 29475.0 29973.3 30187.4 30422.8 30884.8 4194.8 4252.2 4291.2 4292.3 4310.2 249817.0 250552.0 251865.0 252199.0 252410.0 37087.8 37448.4 37488.8 37512.0 37512.4 69184.7 69305.0 69604.0 69759.3 70190.6 19033.3 19048.2 19066.0 19085.5 19223.3 13847.0 13943.7 13946.4 13971.9 14001.6 20719.0 21310.1 21313.8 21387.8 21546.8 7535.2 7822.6 7885.3 7888.7 7940.2 1124.7 1127.5 1190.9 1216.4 1233.8 32956.3 33357.7 33601.7 33880.0 34033.3 1224.5 1227.5 1312.2 1330.7 1333.2 17401.0 17556.6 17584.3 17589.4 17707.5 462306.0 500678.0 519290.0 523554.0 524991.0 57822.4 58910.0 58960.0 59044.4 59152.4 1536.9 1538.4 1564.2 1566.7 1650.6 30373.5 30807.8 30952.5 31033.0 31530.0 55063.0 55679.7 56028.7 56123.4 56364.2 429723.0 430862.0 432130.0 432878.0 433464.0 31332.4 31464.7 31558.0 31849.5 31859.4 51554.0 52166.2 52272.2 52761.7 52966.0 42514.8 43468.8 43494.0 44247.6 45074.8 42928.4 43538.3 43738.1 44543.8 44814.0 42197.2 43429.6 43829.1 44311.6 44468.8 37119.8 37923.0 37994.4 38545.0 38824.0 28698.3 29776.4 30030.8 30051.0 30082.0 03:43:47 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | [#2] jquery.html Cycles:180 Average:29972.92 Median:2481.61 stddev:80530.11 (3245.1%) stddev-sans-first:80725.46 03:43:47 INFO - PROCESS | 31432 | Values: 425.6 433.0 435.9 436.6 441.6 18432.7 19136.3 19141.7 19193.2 20220.6 12555.8 12714.0 13106.7 19821.0 20247.9 5096.9 5249.6 5272.4 5279.4 5283.4 5267.5 5766.9 5772.2 5816.0 5834.8 5720.0 5751.3 5755.9 5760.4 5769.7 5550.4 5772.0 5774.8 5784.6 5802.3 5165.0 5166.4 5219.6 5223.9 5226.9 13375.0 19485.2 23326.2 23597.5 24099.9 2360.2 2431.8 2462.1 2501.1 2639.4 9970.1 10575.0 10693.9 13044.6 14841.7 1986.8 2108.3 2132.6 2207.5 2271.4 75518.0 85391.6 85476.6 85722.6 96037.0 18061.5 18656.0 18669.5 18815.4 18962.4 34599.1 34700.5 34814.3 35084.3 35186.8 10132.7 10481.9 10560.2 10830.5 10884.5 8704.7 8847.3 8847.5 8913.4 8942.1 9568.2 9692.0 9769.7 9808.9 9859.9 3615.6 3683.8 3811.5 3912.0 3938.4 972.3 1062.5 1073.2 1132.9 1142.5 18414.1 19540.7 19550.4 19660.5 19908.0 1104.0 1116.2 1116.5 1125.2 1139.8 10950.8 11090.9 11135.8 11156.8 11168.3 466890.0 491243.0 495122.0 495202.0 496222.0 89244.0 90102.0 90291.5 91689.1 92303.5 1109.9 1117.4 1121.5 1138.0 1146.1 17284.4 17507.8 17849.5 17859.1 17994.8 39455.4 40163.2 40227.8 40766.2 40868.4 53034.5 56064.0 56450.7 56576.0 56610.4 9001.8 9082.3 9179.4 9321.5 9372.0 11311.7 13056.5 13120.5 13756.9 14098.0 11806.2 12259.0 12379.9 12439.0 12440.4 11461.3 11749.2 11873.2 11901.5 12359.4 11691.4 12038.5 12072.4 12221.5 12536.5 8806.8 8855.6 8888.7 9040.0 9073.2 10420.4 12374.9 12422.2 12487.3 12573.9 03:43:47 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | [#3] mootools.html Cycles:180 Average:5476.89 Median:4895.80 stddev:2999.24 (61.3%) stddev-sans-first:2993.06 03:43:47 INFO - PROCESS | 31432 | Values: 1539.8 1559.9 1773.7 1878.0 1893.7 7357.0 7958.6 8083.7 8240.3 8311.0 7174.6 7948.2 8058.4 8097.9 8226.4 2304.0 2316.5 2343.0 2343.6 2350.6 2300.3 2310.6 2326.2 2326.2 2336.7 2289.4 2304.6 2309.7 2310.2 2312.8 2326.0 2334.7 2343.4 2351.9 2354.2 2263.9 2280.5 2281.2 2283.8 2285.4 8286.3 8320.0 8325.6 8347.7 8350.5 5028.9 5092.4 5104.2 5107.2 5125.3 3207.0 3230.3 3276.2 3337.1 3376.1 1090.3 1102.8 1110.7 1115.4 1128.9 10946.6 10975.8 11034.8 11068.7 11071.7 4293.1 4347.1 4401.4 4404.3 4428.5 9456.2 9532.8 9540.0 9544.5 9552.3 5069.9 5094.7 5107.4 5120.8 5130.1 4045.4 4554.5 4611.9 4650.6 4694.3 3921.6 3949.7 3980.1 4035.0 4077.1 1283.6 1289.9 1315.7 1324.7 1336.0 1059.2 1067.1 1073.9 1080.5 1084.7 5740.2 5792.0 5917.1 5921.8 5957.0 450.2 456.3 464.0 464.3 466.6 3723.4 3733.2 3796.3 3801.8 3899.2 10057.3 10402.4 10488.8 10509.8 10521.3 10244.7 10259.4 10287.0 10299.1 10322.1 7941.2 8107.6 8109.5 8131.9 8137.8 5682.9 5708.9 5726.7 5742.5 5788.9 8715.9 8895.8 8899.7 8966.1 8998.0 8868.7 8879.5 8993.3 9001.8 9082.2 7024.5 7422.5 7689.8 7860.0 7975.4 7837.5 7860.1 7908.5 7910.7 7938.8 6953.3 7108.5 7166.9 7312.5 7389.3 7198.5 7260.5 7275.3 7299.6 7310.5 6748.6 6773.3 6790.1 6809.3 6831.8 4883.0 5078.2 5086.7 5118.2 5147.4 4908.6 4974.3 4980.8 5010.4 5032.9 03:43:47 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | [#4] prototype.html Cycles:180 Average:5879.14 Median:6757.31 stddev:1827.12 (27.0%) stddev-sans-first:1784.01 03:43:47 INFO - PROCESS | 31432 | Values: 322.4 325.8 331.4 357.4 357.9 6474.1 6624.8 6675.9 6690.6 6844.5 6622.5 6679.6 6694.0 6696.1 6706.3 4924.9 4925.8 4929.1 4933.9 4935.0 4874.9 5020.3 5029.9 5038.5 5047.3 4954.0 4965.4 4967.6 4970.3 4988.1 4941.9 4974.0 4980.2 4986.6 4993.6 4342.7 4343.5 4347.5 4350.8 4352.4 6371.0 6373.4 6380.3 6383.9 6384.8 5507.6 5698.3 5726.7 5773.8 5799.6 6973.2 6998.1 7000.3 7002.2 7014.1 4663.9 4676.3 4680.4 4691.5 4696.8 7286.5 7328.4 7363.0 7384.6 7386.3 4901.0 4901.9 4905.1 4905.9 4910.4 4793.6 4943.8 4962.3 4977.5 4988.0 5760.7 5783.3 5787.5 5793.4 5796.2 7027.1 7033.0 7061.0 7061.9 7080.0 1688.0 1689.0 1691.5 1692.3 1705.4 1106.6 1123.7 1132.7 1135.9 1141.3 6841.5 6867.6 6882.0 6883.9 6904.7 7236.6 7249.4 7262.2 7267.5 7305.5 6594.9 6697.0 6860.2 6864.8 6897.7 3945.2 3970.8 3974.5 3977.2 3986.8 7672.3 7677.4 7680.1 7694.2 7694.5 7522.8 7527.6 7532.7 7539.3 7540.5 7380.7 7657.0 7665.7 7718.8 7722.5 7362.6 7379.3 7396.3 7400.2 7414.4 7259.0 7277.8 7304.4 7310.6 7313.0 7672.7 7695.2 7711.0 7711.6 7724.8 4639.0 4782.2 4814.5 4825.1 4855.8 7174.9 7174.9 7218.6 7256.1 7281.7 6941.7 6995.4 7056.5 7060.4 7063.1 7044.9 7050.9 7089.1 7104.9 7135.8 6808.3 6910.1 6919.5 6922.7 6948.7 7048.9 7079.6 7081.6 7085.4 7089.3 6916.4 6920.1 6923.1 6924.9 6926.5 03:43:47 INFO - PROCESS | 31432 | 03:43:47 INFO - PROCESS | 31432 | [#5] yui.html Cycles:180 Average:15537.31 Median:24159.51 stddev:17661.51 (73.1%) stddev-sans-first:17676.57 03:43:47 INFO - PROCESS | 31432 | Values: 841.6 869.9 918.9 925.4 925.8 14710.9 14719.2 14985.3 15002.3 15005.8 13930.3 13964.7 13970.1 13997.7 14017.6 748.5 884.3 890.2 903.0 906.1 913.4 915.7 917.0 917.1 917.3 965.0 972.6 973.3 973.5 976.7 965.9 966.9 968.3 969.8 970.3 712.1 715.1 715.9 717.0 719.3 14260.9 14398.5 14466.9 14472.6 14508.5 15304.4 15358.5 15388.8 15497.5 15701.3 12020.8 12140.1 12178.5 12337.8 12462.6 4010.2 4012.3 4088.3 4093.4 4179.5 54846.0 55032.7 55091.0 55149.0 55671.7 11470.8 11695.6 11701.2 11738.9 11747.4 21504.7 21723.8 21729.2 21775.0 21811.7 8164.0 8296.0 8320.6 8435.4 8634.7 4499.6 4557.7 4928.1 4975.6 5095.0 3320.6 3321.8 3326.8 3330.7 3362.8 571.5 573.6 578.7 579.1 583.0 690.6 722.3 796.8 815.7 816.1 8743.6 8845.2 9088.1 9196.1 9197.0 670.0 736.3 820.5 837.4 839.6 4331.8 4451.2 4463.1 4486.5 4575.8 62801.0 63393.0 63637.7 63739.7 64345.7 54001.2 58648.4 59222.0 59666.4 60279.4 49405.3 49711.8 50330.2 50681.0 51141.0 9845.5 9999.7 10013.3 10350.2 10425.6 38049.0 38676.4 38870.2 39001.0 40054.0 43678.7 43867.8 46607.5 49450.8 50204.0 11683.5 12084.0 12108.3 12176.4 12195.9 13816.3 13964.8 14394.1 14434.6 15005.9 13376.4 13623.6 13628.5 13678.8 14073.4 13036.9 13057.5 13471.8 14148.2 14213.9 13090.0 13382.6 13529.6 13592.7 13920.7 11417.2 11517.4 11651.7 11669.0 11831.9 11460.1 11524.3 11534.8 11547.5 11647.7 03:43:47 INFO - PROCESS | 31432 | -------- Summary: end -------- 03:43:47 INFO - PROCESS | 31432 | 03:43:48 INFO - TEST-INFO | 31432: exit 0 03:43:48 INFO - TEST-OK | dromaeo_css | took 1108255ms 03:43:48 INFO - TEST-START | kraken 03:43:48 INFO - operating with platform_type : linux_ 03:43:48 INFO - Initialising browser for kraken test... 03:43:48 INFO - TEST-INFO | started process 31672 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGT3JXs/profile http://localhost:50078/getInfo.html) 03:43:51 INFO - PROCESS | 31672 | 03:43:51 INFO - PROCESS | 31672 | (process:31750): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:43:51 INFO - PROCESS | 31672 | __metrics Screen width/height:1600/1200 03:43:51 INFO - PROCESS | 31672 | colorDepth:24 03:43:51 INFO - PROCESS | 31672 | Browser inner width/height: 1024/697 03:43:51 INFO - PROCESS | 31672 | __metrics 03:43:52 ERROR - PROCESS | 31672 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2940: TypeError: this.tabs is undefined 03:43:53 INFO - TEST-INFO | 31672: exit 0 03:43:53 INFO - Browser initialized. 03:43:53 INFO - Running cycle 1/1 for kraken test... 03:43:53 INFO - TEST-INFO | started process 31801 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGT3JXs/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:43:54 INFO - PROCESS | 31801 | 03:43:54 INFO - PROCESS | 31801 | (process:31868): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:44:04 INFO - PROCESS | 31801 | RSS: Main: 152625152 03:44:04 INFO - PROCESS | 31801 | 03:44:07 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50078/tests/kraken/driver.html?testName=audio-beat-detection) 03:44:08 INFO - PROCESS | 31801 | RSS: Main: 157237248 03:44:08 INFO - PROCESS | 31801 | 03:44:10 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50078/tests/kraken/driver.html?testName=audio-dft) 03:44:11 INFO - PROCESS | 31801 | RSS: Main: 157196288 03:44:11 INFO - PROCESS | 31801 | 03:44:14 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50078/tests/kraken/driver.html?testName=audio-fft) 03:44:15 INFO - PROCESS | 31801 | RSS: Main: 157573120 03:44:15 INFO - PROCESS | 31801 | 03:44:17 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50078/tests/kraken/driver.html?testName=audio-oscillator) 03:44:17 INFO - PROCESS | 31801 | RSS: Main: 157433856 03:44:17 INFO - PROCESS | 31801 | 03:44:19 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50078/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:44:20 INFO - PROCESS | 31801 | RSS: Main: 157016064 03:44:20 INFO - PROCESS | 31801 | 03:44:23 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50078/tests/kraken/driver.html?testName=imaging-darkroom) 03:44:24 INFO - PROCESS | 31801 | RSS: Main: 156880896 03:44:24 INFO - PROCESS | 31801 | 03:44:27 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50078/tests/kraken/driver.html?testName=imaging-desaturate) 03:44:28 INFO - PROCESS | 31801 | RSS: Main: 157114368 03:44:28 INFO - PROCESS | 31801 | 03:44:30 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50078/tests/kraken/driver.html?testName=json-parse-financial) 03:44:31 INFO - PROCESS | 31801 | RSS: Main: 158035968 03:44:31 INFO - PROCESS | 31801 | 03:44:33 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50078/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:44:33 INFO - PROCESS | 31801 | RSS: Main: 157691904 03:44:33 INFO - PROCESS | 31801 | 03:44:35 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50078/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:44:36 INFO - PROCESS | 31801 | RSS: Main: 157839360 03:44:36 INFO - PROCESS | 31801 | 03:44:37 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50078/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:44:38 INFO - PROCESS | 31801 | RSS: Main: 158236672 03:44:38 INFO - PROCESS | 31801 | 03:44:41 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50078/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:44:41 INFO - PROCESS | 31801 | RSS: Main: 158736384 03:44:41 INFO - PROCESS | 31801 | 03:44:44 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50078/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:44:45 INFO - PROCESS | 31801 | RSS: Main: 159023104 03:44:45 INFO - PROCESS | 31801 | 03:44:46 INFO - PROCESS | 31801 | Cycle 1(1): loaded http://localhost:50078/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50078/tests/kraken/driver.html?testName=ai-astar) 03:44:47 INFO - PROCESS | 31801 | RSS: Main: 159907840 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | __start_tp_report 03:44:47 INFO - PROCESS | 31801 | _x_x_mozilla_page_load 03:44:47 INFO - PROCESS | 31801 | _x_x_mozilla_page_load_details 03:44:47 INFO - PROCESS | 31801 | |i|pagename|runs| 03:44:47 INFO - PROCESS | 31801 | |0;ai-astar;109;113;107;109;113;112;103;110;110;111 03:44:47 INFO - PROCESS | 31801 | |1;audio-beat-detection;156;136;163;176;127;155;156;128;193;128 03:44:47 INFO - PROCESS | 31801 | |2;audio-dft;162;162;162;162;163;161;162;161;162;164 03:44:47 INFO - PROCESS | 31801 | |3;audio-fft;75;76;76;173;76;76;75;77;172;76 03:44:47 INFO - PROCESS | 31801 | |4;audio-oscillator;92;92;150;92;92;91;145;92;98;144 03:44:47 INFO - PROCESS | 31801 | |5;imaging-gaussian-blur;118;118;117;117;118;118;118;117;117;119 03:44:47 INFO - PROCESS | 31801 | |6;imaging-darkroom;147;147;148;146;146;147;146;146;148;146 03:44:47 INFO - PROCESS | 31801 | |7;imaging-desaturate;95;95;95;96;96;96;95;95;96;96 03:44:47 INFO - PROCESS | 31801 | |8;json-parse-financial;55;58;57;56;57;56;58;69;54;54 03:44:47 INFO - PROCESS | 31801 | |9;json-stringify-tinderbox;57;58;58;57;58;58;57;58;58;57 03:44:47 INFO - PROCESS | 31801 | |10;stanford-crypto-aes;72;71;72;73;80;75;81;74;74;73 03:44:47 INFO - PROCESS | 31801 | |11;stanford-crypto-ccm;118;114;116;113;115;125;120;116;125;125 03:44:47 INFO - PROCESS | 31801 | |12;stanford-crypto-pbkdf2;170;163;156;161;160;155;157;157;167;156 03:44:47 INFO - PROCESS | 31801 | |13;stanford-crypto-sha256-iterative;66;64;66;67;68;65;67;71;75;76 03:44:47 INFO - PROCESS | 31801 | __end_tp_report 03:44:47 INFO - PROCESS | 31801 | __start_cc_report 03:44:47 INFO - PROCESS | 31801 | _x_x_mozilla_cycle_collect,839 03:44:47 INFO - PROCESS | 31801 | __end_cc_report 03:44:47 INFO - PROCESS | 31801 | __startTimestamp1464950687044__endTimestamp 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | ------- Summary: start ------- 03:44:47 INFO - PROCESS | 31801 | Number of tests: 14 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#0] ai-astar Cycles:10 Average:109.70 Median:110.50 stddev:3.02 (2.7%) stddev-sans-first:3.19 03:44:47 INFO - PROCESS | 31801 | Values: 109.0 113.0 107.0 109.0 113.0 112.0 103.0 110.0 110.0 111.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#1] audio-beat-detection Cycles:10 Average:151.80 Median:156.00 stddev:22.24 (14.3%) stddev-sans-first:23.54 03:44:47 INFO - PROCESS | 31801 | Values: 156.0 136.0 163.0 176.0 127.0 155.0 156.0 128.0 193.0 128.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#2] audio-dft Cycles:10 Average:162.10 Median:162.00 stddev:0.88 (0.5%) stddev-sans-first:0.93 03:44:47 INFO - PROCESS | 31801 | Values: 162.0 162.0 162.0 162.0 163.0 161.0 162.0 161.0 162.0 164.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#3] audio-fft Cycles:10 Average:95.20 Median:76.00 stddev:40.75 (53.6%) stddev-sans-first:42.56 03:44:47 INFO - PROCESS | 31801 | Values: 75.0 76.0 76.0 173.0 76.0 76.0 75.0 77.0 172.0 76.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#4] audio-oscillator Cycles:10 Average:108.80 Median:92.00 stddev:26.02 (28.3%) stddev-sans-first:26.87 03:44:47 INFO - PROCESS | 31801 | Values: 92.0 92.0 150.0 92.0 92.0 91.0 145.0 92.0 98.0 144.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#5] imaging-gaussian-blur Cycles:10 Average:117.70 Median:118.00 stddev:0.67 (0.6%) stddev-sans-first:0.71 03:44:47 INFO - PROCESS | 31801 | Values: 118.0 118.0 117.0 117.0 118.0 118.0 118.0 117.0 117.0 119.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#6] imaging-darkroom Cycles:10 Average:146.70 Median:147.00 stddev:0.82 (0.6%) stddev-sans-first:0.87 03:44:47 INFO - PROCESS | 31801 | Values: 147.0 147.0 148.0 146.0 146.0 147.0 146.0 146.0 148.0 146.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:96.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 03:44:47 INFO - PROCESS | 31801 | Values: 95.0 95.0 95.0 96.0 96.0 96.0 95.0 95.0 96.0 96.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#8] json-parse-financial Cycles:10 Average:57.40 Median:57.00 stddev:4.33 (7.6%) stddev-sans-first:4.50 03:44:47 INFO - PROCESS | 31801 | Values: 55.0 58.0 57.0 56.0 57.0 56.0 58.0 69.0 54.0 54.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#9] json-stringify-tinderbox Cycles:10 Average:57.60 Median:58.00 stddev:0.52 (0.9%) stddev-sans-first:0.50 03:44:47 INFO - PROCESS | 31801 | Values: 57.0 58.0 58.0 57.0 58.0 58.0 57.0 58.0 58.0 57.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#10] stanford-crypto-aes Cycles:10 Average:74.50 Median:74.00 stddev:3.37 (4.6%) stddev-sans-first:3.46 03:44:47 INFO - PROCESS | 31801 | Values: 72.0 71.0 72.0 73.0 80.0 75.0 81.0 74.0 74.0 73.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#11] stanford-crypto-ccm Cycles:10 Average:118.70 Median:119.00 stddev:4.76 (4.0%) stddev-sans-first:5.04 03:44:47 INFO - PROCESS | 31801 | Values: 118.0 114.0 116.0 113.0 115.0 125.0 120.0 116.0 125.0 125.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:160.20 Median:160.50 stddev:5.09 (3.2%) stddev-sans-first:3.98 03:44:47 INFO - PROCESS | 31801 | Values: 170.0 163.0 156.0 161.0 160.0 155.0 157.0 157.0 167.0 156.0 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - PROCESS | 31801 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.50 Median:67.50 stddev:4.14 (6.1%) stddev-sans-first:4.29 03:44:47 INFO - PROCESS | 31801 | Values: 66.0 64.0 66.0 67.0 68.0 65.0 67.0 71.0 75.0 76.0 03:44:47 INFO - PROCESS | 31801 | -------- Summary: end -------- 03:44:47 INFO - PROCESS | 31801 | 03:44:47 INFO - TEST-INFO | 31801: exit 0 03:44:48 INFO - TEST-OK | kraken | took 59949ms 03:44:48 INFO - SUITE-END | took 1168s 03:44:48 INFO - Completed test suite (00:19:28) 03:44:48 INFO - javascript benchmark 03:44:48 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3332.6334103248646, 3384.035549868288, 3391.220019395539, 3427.605825330088, 3442.087846720618, 5503.532199763025, 5510.8071217507395, 5511.834644960658, 5541.279633647625, 5550.555955523559, 5491.395946445888, 5549.250851135095, 5559.861003474915, 5564.0, 5587.720613969295, 5090.465501122384, 5092.872678183038, 5149.0731668299695, 5158.226266060084, 5166.380034395877, 5037.06814239365, 5136.820211292606, 5210.713410762407, 5254.600768041498, 5280.419153893069, 5002.9499705002845, 5067.49325067494, 5102.617303702219, 5134.897302053957, 5186.636935414523, 5077.390713114413, 5092.414372347191, 5101.897962040757, 5103.566196873233, 5155.896882062375, 4782.426108866924, 5076.0, 5084.491550844923, 5103.2855400244, 5131.923021154686, 5490.752916118784, 5529.30883639545, 5547.833564993057, 5577.274954255961, 5614.719264036782, 5822.854428639275, 5844.0, 5845.152452894349, 5851.912221316684, 5890.352061273256, 5727.856803579903, 5895.882082358329, 5929.495992840613, 5943.257092863392, 6072.848178795565, 5638.238837756932, 5648.3222013358245, 5672.035753921843, 5676.971615141939, 5689.345725241609, 6095.512359011268, 6115.449609535163, 6127.84680382994, 6148.231471066117, 6149.0776383542825, 5761.452661997104, 5883.558733095035, 5897.056470964625, 5937.970310148508, 5978.85052873673, 5945.286565612154, 5949.970250148722, 5956.76172953077, 5962.791302304398, 5964.582479226413, 5882.882342353215, 5888.587798854125, 5918.615290006222, 5935.317438494542, 5958.285005799332, 5770.0, 5865.472107510344, 5920.5559583031445, 5923.200367950358, 5973.98442264816, 4503.279475283939, 4503.954960450419, 4515.480719717275, 4518.661100417482, 4533.274676051816, 4072.735272207297, 4082.3264161413626, 4089.2026054919006, 4100.17996400721, 4110.7328023678965, 5593.74828132735, 5610.691411972299, 5784.1902133701315, 5853.824385268449, 5874.941250587525, 5911.231539899785, 6008.369121242206, 6053.909191362133, 6065.363136870653, 6078.270607527125, 5793.565482588822, 5804.2744656917885, 5808.361080281165, 5819.73811178498, 5820.767169313265, 4911.140550403665, 5023.598112151019, 5032.6980381177245, 5105.412877519058, 5189.40321862983, 6214.130021796952, 6235.469985051322, 6250.9062364064575, 6261.342559031327, 6276.309605943343, 6012.8797424052145, 6037.849053773691, 6041.033434650435, 6042.115039872832, 6058.848528786815, 5978.551608629283, 6144.525313924715, 6207.410296021871, 6231.719572619334, 6237.1891654084675, 5862.149988251765, 5898.970505147447, 5903.527717782653, 5906.0, 5926.555508336805, 5999.850003749942, 6012.458878700938, 6015.398460154124, 6026.487748541248, 6029.095635654687, 5675.602707810413, 5797.362290147996, 5813.883722325614, 5818.2436283282905, 5863.2670916135485, 5859.20900678403, 5885.14665373527, 5890.087036509348, 5916.911246331222, 5923.437273459014, 5516.089845175501, 5825.097109947965, 5827.0, 5840.123981402823, 5850.151727999331, 5882.088276317178, 5925.644461332334, 5934.406559344204, 5955.136505206808, 5960.254968128984, 5744.597878148489, 5763.740631671669, 5767.452092051416, 5774.8845023098465, 5784.363719990713], "value": 5522.244245326094, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [647.4237928243863, 664.8637029408972, 668.6760214774746, 676.7191615479576, 773.0761739721029, 38502.61497385025, 39204.60795392049, 39231.0, 39361.80319098404, 39455.40816887749, 40436.19127617446, 40890.79554602223, 41164.38253426201, 41201.0, 41418.0, 8550.572471376438, 8705.608247628872, 8729.127087291283, 8730.607122679463, 8754.912450875505, 8787.725779761931, 8942.15049570293, 8982.685606003792, 8987.0, 8994.955025224865, 8943.373963822534, 8952.955235223815, 9002.369834111614, 9008.504532250723, 9008.504532250723, 8935.195832375084, 8948.597313120892, 8960.327975401839, 8971.147740964598, 8989.46063236208, 8815.867761983576, 8910.331725120643, 8934.955325223398, 8937.46375217489, 8939.597718102701, 33549.32901341984, 41834.790826045675, 42323.36514952278, 42595.78702106501, 42648.78675606633, 3313.6023677158896, 3649.981750091259, 3766.0020094674933, 3992.3412636914873, 4431.512533621299, 29475.0, 29973.25066873324, 30187.396252075054, 30422.84788576065, 30884.84557577198, 4194.790260486963, 4252.170826688797, 4291.163223171483, 4292.2668782386445, 4310.245707001262, 249817.0, 250552.0, 251865.0, 252199.0, 252410.0, 37087.81456092702, 37448.43827342592, 37488.81255593759, 37512.0, 37512.43731344032, 69184.65407672929, 69305.0, 69604.0, 69759.30240697529, 70190.64904675444, 19033.333833316043, 19048.238070477026, 19066.0, 19085.522861928563, 19223.32718354851, 13847.030707850556, 13943.721125577635, 13946.372413241428, 13971.86028139726, 14001.579952601438, 20719.0, 21310.147594096063, 21313.78686213118, 21387.786122138892, 21546.78453215479, 7535.208803075708, 7822.569758663214, 7885.329746971457, 7888.675144277589, 7940.205979402013, 1124.6907100547414, 1127.4685103508477, 1190.9460127786797, 1216.3614102596207, 1233.7655845389527, 32956.3408731824, 33357.66642333594, 33601.66398336034, 33880.0, 34033.31933361319, 1224.455117472716, 1227.533537255837, 1312.1864444044754, 1330.7272009238084, 1333.2134040915905, 17400.955942643483, 17556.648867022588, 17584.296628134987, 17589.384371546934, 17707.468775936486, 462306.0, 500678.0, 519290.0, 523554.0, 524991.0, 57822.421775782546, 58910.0, 58960.0, 59044.40955590475, 59152.40847591555, 1536.9001014933995, 1538.369268599891, 1564.1788061267698, 1566.7258229809738, 1650.6038550747974, 30373.544396833622, 30807.84596077095, 30952.535711963887, 31033.0, 31530.0, 55063.0, 55679.721601391735, 56028.71985640046, 56123.43876561182, 56364.154537682785, 429723.0, 430862.0, 432130.0, 432878.0, 433464.0, 31332.37335253328, 31464.685353146175, 31558.0, 31849.522257165696, 31859.36281274408, 51554.0, 52166.21750673819, 52272.21591676204, 52761.7361913188, 52966.0, 42514.78742606267, 43468.782656086514, 43494.0, 44247.557524424345, 45074.77462612666, 42928.35607465828, 43538.34692479679, 43738.12523749444, 44543.777281113384, 44814.0, 42197.15605687808, 43429.56570434382, 43829.123417530835, 44311.55688443203, 44468.777656112805, 37119.814400927826, 37923.0, 37994.43008354821, 38545.0, 38824.0, 28698.282542936595, 29776.362300073702, 30030.849845750632, 30051.0, 30082.0], "value": 20526.2216074732, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [425.6148185891769, 432.976186309753, 435.8547348550364, 436.5699785711074, 441.63344424127956, 18432.723509147356, 19136.330228442006, 19141.712874306897, 19193.232270709188, 20220.59558808823, 12555.811662825065, 12714.0, 13106.737865242689, 19821.0, 20247.898760506177, 5096.949030509694, 5249.606279529032, 5272.393674727398, 5279.41926388097, 5283.392409872856, 5267.499587539197, 5766.913496297559, 5772.249607551013, 5816.040353341694, 5834.766609335643, 5719.999000174974, 5751.338596061444, 5755.884882302373, 5760.366359700451, 5769.740361683714, 5550.361708403545, 5772.0187568113315, 5774.82675519735, 5784.623999440023, 5802.332731735841, 5164.974175129138, 5166.43169251382, 5219.634625576211, 5223.921641175385, 5226.947730522684, 13375.0, 19485.220591176338, 23326.183583574664, 23597.528049438915, 24099.87950060256, 2360.1621424394266, 2431.841930274544, 2462.0890270599994, 2501.137107697841, 2639.4325220077776, 9970.075900200143, 10575.0, 10693.9465302673, 13044.608661740163, 14841.70316593662, 1986.8112529309692, 2108.2621082621113, 2132.5734853029303, 2207.4922767763505, 2271.4207876991427, 75518.0, 85391.57304213502, 85476.57261713651, 85722.57138714267, 96037.0, 18061.458156255332, 18656.0, 18669.533261668566, 18815.435536933914, 18962.43112706621, 34599.13502162466, 34700.47949280763, 34814.30371392558, 35084.29831403409, 35186.824065879504, 10132.746681332877, 10481.895181048245, 10560.155187584975, 10830.512626931806, 10884.510197041152, 8704.738857834274, 8847.292216622654, 8847.51338676379, 8913.37606367561, 8942.105789421135, 9568.186704130088, 9691.951540242395, 9769.658061967939, 9808.901910980941, 9859.901400986042, 3615.6203598621764, 3683.7659384106623, 3811.5415556965604, 3911.9804400977814, 3938.448617193595, 972.3290929258789, 1062.5484169228048, 1073.1682945717132, 1132.8640563132476, 1142.4573327669457, 18414.079296035146, 19540.70688939667, 19550.413487595393, 19660.50848728793, 19908.0, 1103.968628229636, 1116.17403121691, 1116.5143162724241, 1125.1954852280658, 1139.800534906388, 10950.835737463944, 11090.944545277222, 11135.832962505569, 11156.776864462827, 11168.329900206014, 466890.0, 491243.0, 495122.0, 495202.0, 496222.0, 89244.0, 90102.0, 90291.54854225687, 91689.08310916938, 92303.53848230717, 1109.8890110988998, 1117.3631030312645, 1121.5401685308984, 1138.0269869261826, 1146.094585277638, 17284.395046173322, 17507.82492175062, 17849.464516064538, 17859.107044647975, 17994.820051799838, 39455.408168876915, 40163.19673606453, 40227.79886100551, 40766.18467630571, 40868.386974194815, 53034.4696553045, 56064.0, 56450.71774641265, 56576.0, 56610.43389566051, 9001.819963600561, 9082.273418126402, 9179.449233046038, 9321.533923303672, 9372.015938326378, 11311.717207069889, 13056.543020994219, 13120.475180992653, 13756.862431375559, 14098.0, 11806.173567850168, 12259.0, 12379.876201238232, 12439.0, 12440.440180191732, 11461.312321260752, 11749.236299640495, 11873.168878178445, 11901.464434100659, 12359.3820308986, 11691.415429228335, 12038.518459261883, 12072.396380181131, 12221.511139554319, 12536.498540058295, 8806.779830504289, 8855.55722213874, 8888.73333799987, 9040.0, 9073.228775554151, 10420.42687652156, 12374.938125309676, 12422.192557483735, 12487.250764954131, 12573.87426125727], "value": 10193.220050218753, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1539.7844301797747, 1559.9142047187406, 1773.654137443199, 1878.0, 1893.6875415556433, 7356.963215183917, 7958.641861116249, 8083.676652933883, 8240.299574536164, 8310.999999999993, 7174.6412679366085, 7948.244916732916, 8058.39562032847, 8097.91902080979, 8226.42415030948, 2303.9539209215804, 2316.5482730867448, 2342.9882850585723, 2343.5781559319316, 2350.635651474024, 2300.275413244831, 2310.560993411255, 2326.1974618756503, 2326.232343326698, 2336.7429582745885, 2289.3589794857385, 2304.5736538740302, 2309.722833260011, 2310.1914329984456, 2312.838101332907, 2325.9651105233434, 2334.661474086265, 2343.379004563792, 2351.8588884666888, 2354.211339201361, 2263.932082037525, 2280.5210905709655, 2281.2243837095466, 2283.817294616427, 2285.42864283929, 8286.295664868494, 8320.0, 8325.583720813935, 8347.707830225974, 8350.457220280723, 5028.949710502921, 5092.363454568179, 5104.157813960692, 5107.182850743863, 5125.256837758541, 3206.9679303206904, 3230.3216324571868, 3276.1973316537365, 3337.0823023668445, 3376.1390845334527, 1090.3294473898495, 1102.8345748137845, 1110.7167672243527, 1115.3921112993437, 1128.8871112888646, 10946.56213751449, 10975.83536246949, 11034.834477482844, 11068.667939961813, 11071.667849964433, 4293.098449325614, 4347.0871117065135, 4401.449818772653, 4404.339349097597, 4428.535003824616, 9456.196223321094, 9532.761680958032, 9540.045995400404, 9544.475053872104, 9552.283578731623, 5069.898602027939, 5094.719790411563, 5107.387113546398, 5120.846374608767, 5130.076586214517, 4045.3527435610163, 4554.4990051094355, 4611.9077618447445, 4650.558196971282, 4694.319323698113, 3921.6078392160557, 3949.7037722170953, 3980.0845805464905, 4035.0315924177985, 4077.062275676611, 1283.595667364777, 1289.8774616411426, 1315.6776589735575, 1324.6953200763878, 1336.0313772515044, 1059.2426415113232, 1067.0876400677464, 1073.9409332486632, 1080.4813689429118, 1084.739662480999, 5740.225069615632, 5791.957447659377, 5917.142014407887, 5921.815636872643, 5957.0, 450.1559575795384, 456.25630222736726, 464.02786162988485, 464.305862735213, 466.61970494047245, 3723.4042553191903, 3733.197362567061, 3796.3166630006313, 3801.7718936863325, 3899.2201559688174, 10057.346272492265, 10402.375857448576, 10488.842667359995, 10509.84235236472, 10521.263511554118, 10244.692659220234, 10259.435731034864, 10287.0, 10299.124574411258, 10322.12261957727, 7941.245581669732, 8107.554084525408, 8109.472884262504, 8131.918680813116, 8137.796555086052, 5682.9147562785765, 5708.914366284592, 5726.742296596746, 5742.454466825645, 5788.884222315614, 8715.869261960948, 8895.777605559653, 8899.688510902088, 8966.148215919477, 8998.0, 8868.733937981871, 8879.511626860585, 8993.28053755685, 9001.819963600561, 9082.228010619172, 7024.5434046786795, 7422.517536360119, 7689.807754806175, 7859.960700196462, 7975.401844861774, 7837.529748215125, 7860.096088949844, 7908.52548847071, 7910.683572657029, 7938.841223175619, 6953.269906659728, 7108.46686498525, 7166.89249661266, 7312.5246858954, 7389.261073892782, 7198.49610527279, 7260.528065675714, 7275.308845659654, 7299.648011789272, 7310.451716121206, 6748.561343512656, 6773.288804675635, 6790.117284752951, 6809.250982392032, 6831.829204269933, 4883.0, 5078.238264260391, 5086.669366491166, 5118.181091025418, 5147.40804807452, 4908.607311415007, 4974.253861920596, 4980.825671101494, 5010.398752149766, 5032.874178145576], "value": 4399.094333868389, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [322.3681584095173, 325.8126577218097, 331.4067818604698, 357.3852972886634, 357.9409397449421, 6474.125992990945, 6624.801255962323, 6675.899861502081, 6690.565113267634, 6844.486663500233, 6622.47020238381, 6679.565828221174, 6694.0, 6696.06255124283, 6706.329367063291, 4924.876878078041, 4925.82759603414, 4929.137400954827, 4933.8519844404545, 4934.97532512337, 4874.8537543873745, 5020.297158397827, 5029.899402011957, 5038.496150384951, 5047.293378926953, 4954.033963377143, 4965.42897566779, 4967.552920237178, 4970.304157417964, 4988.102141614526, 4941.901161976776, 4974.0, 4980.228064649967, 4986.551210391046, 4993.6005119590345, 4342.717723347972, 4343.457067866517, 4347.456567929009, 4350.782460876975, 4352.412424322739, 6371.0, 6373.362663733589, 6380.298167201604, 6383.904241436382, 6384.840378990516, 5507.586930980193, 5698.259226300595, 5726.656400615976, 5773.797917072882, 5799.623024503436, 6973.198082220559, 6998.090248267693, 7000.334968178015, 7002.229754726976, 7014.123234595676, 4663.88340291492, 4676.298555216711, 4680.4149481314835, 4691.460482044575, 4696.7651617419, 7286.526375785557, 7328.413726901835, 7363.042804435443, 7384.593847338394, 7386.3352298292875, 4901.044296362246, 4901.852944411673, 4905.141600219948, 4905.9018819624125, 4910.410750709938, 4793.592544633675, 4943.777530011158, 4962.255661650781, 4977.527134922177, 4987.950120498821, 5760.711964401763, 5783.306003279633, 5787.450192231731, 5793.391693872167, 5796.21751063601, 7027.051348068047, 7033.0, 7061.0, 7061.858762824818, 7080.0, 1687.9746803797952, 1688.9915550422415, 1691.4502786594405, 1692.2892385198247, 1705.4457301376854, 1106.6126855600637, 1123.6797512709002, 1132.7111586545377, 1135.858462245438, 1141.3437273567731, 6841.521093523405, 6867.553609015398, 6882.03651488792, 6883.931160688429, 6904.689288982008, 7236.565806051549, 7249.383802376751, 7262.20115787263, 7267.491275610762, 7305.452091093083, 6594.934050659432, 6696.966515167393, 6860.245373008965, 6864.759733409307, 6897.7240910363025, 3945.2109578084496, 3970.7617542947514, 3974.4833171687496, 3977.2244412339314, 3986.760794352348, 7672.347850432776, 7677.424193185422, 7680.078390593053, 7694.192109828499, 7694.499857509244, 7522.774316770506, 7527.623618819037, 7532.736354227685, 7539.283768042027, 7540.547567145989, 7380.667869945865, 7656.961715191388, 7665.731699390494, 7718.845623087619, 7722.53664780115, 7362.595057271901, 7379.298966598165, 7396.3343299103335, 7400.185979542353, 7414.406847452083, 7258.963705181652, 7277.8180545484665, 7304.415646748141, 7310.561366318038, 7313.0, 7672.6547305372505, 7695.23047695226, 7711.0, 7711.614419279126, 7724.7682569523, 4638.953610463987, 4782.187028205144, 4814.470408255019, 4825.059113472839, 4855.757212139309, 7174.892376614251, 7174.892376614459, 7218.639068046472, 7256.129264488295, 7281.708731650675, 6941.687624057031, 6995.440364770908, 7056.54132481387, 7060.435165186876, 7063.117110361205, 7044.894326585208, 7050.929490705027, 7089.0784198053925, 7104.857902842017, 7135.82160445993, 6808.28513006147, 6910.101686780687, 6919.515633905779, 6922.688479018356, 6948.652567371712, 7048.929510704827, 7079.610621415665, 7081.610511421921, 7085.362317391253, 7089.291070892869, 6916.412104971134, 6920.134983127109, 6923.09999700056, 6924.861502770017, 6926.515143939876], "value": 5267.306326476017, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [841.6170642357728, 869.8695195720641, 918.9448633082013, 925.4262357338449, 925.8240934222493, 14710.852891471082, 14719.190444525548, 14985.32566034527, 15002.324895379707, 15005.84994150058, 13930.303484825768, 13964.650883727913, 13970.091944023632, 13997.720045599082, 14017.64955876101, 748.4985060009807, 884.2528063786091, 890.2032680750724, 902.9638814447414, 906.0939060939061, 913.4336711239008, 915.7390143809016, 916.9770755731093, 917.0600134861787, 917.2661870503604, 964.9758756031121, 972.5915115651443, 973.304087577382, 973.4937832327186, 976.653288082731, 965.9420434773901, 966.8791401074866, 968.3028219681853, 969.762408209986, 970.3159272712755, 712.0885266858429, 715.0882624653557, 715.9033530473372, 717.046328383249, 719.3238355945394, 14260.928695356457, 14398.496052638213, 14466.855331446655, 14472.638184045483, 14508.492202772957, 15304.387824487007, 15358.462453814174, 15388.846111538853, 15497.45758898433, 15701.293441795147, 12020.819687704692, 12140.089493287951, 12178.51285948561, 12337.814932776015, 12462.563810266598, 4010.177913527749, 4012.277789997799, 4088.2641124597562, 4093.4269202311702, 4179.540250572434, 54846.0, 55032.724836375965, 55091.0, 55149.0, 55671.72164139194, 11470.770584588428, 11695.590654327058, 11701.239419437708, 11738.94130529342, 11747.353895535656, 21504.677429838564, 21723.782762172494, 21729.239476618244, 21775.0, 21811.67282490764, 8163.959180204061, 8296.045954715284, 8320.625571849281, 8435.409521333448, 8634.697785577475, 4499.6400287976885, 4557.72653640776, 4928.088303663833, 4975.5522003019905, 5095.031943930641, 3320.634730179678, 3321.80069195849, 3326.8003919764406, 3330.733541316689, 3362.7814192077435, 571.5341996273107, 573.6357413042665, 578.6585914310577, 579.1023912934934, 583.0350769476523, 690.5545922879814, 722.2777222777223, 796.7928338631997, 815.6655771133925, 816.1063635319316, 8743.606537705818, 8845.159709827556, 9088.10598977497, 9196.12636799503, 9197.0, 669.9782831182389, 736.3262614707589, 820.4502983001404, 837.4221786966973, 839.588601585231, 4331.761753103547, 4451.243288640939, 4463.129689710475, 4486.528914463935, 4575.816967321336, 62801.0, 63393.0, 63637.681811591574, 63739.6813015932, 64345.67827160834, 54001.189982150296, 58648.4135158643, 59222.0, 59666.40333596608, 60279.397206028254, 49405.25892111621, 49711.75144124329, 50330.24504632434, 50681.0, 51141.0, 9845.45849978258, 9999.700008999742, 10013.349132306377, 10350.223733219887, 10425.582976681151, 38049.0, 38676.41985370166, 38870.2225955485, 39001.0, 40054.0, 43678.68963931087, 43867.78066109649, 46607.53392466032, 49450.75274623604, 50204.0, 11683.474243659226, 12084.0, 12108.273503589813, 12176.39118044112, 12195.878041219474, 13816.309184540532, 13964.790528141883, 14394.064385814889, 14434.639134021734, 15005.924970375077, 13376.398062087424, 13623.591292261248, 13628.523001694894, 13678.794818077538, 14073.366698498387, 13036.934815325863, 13057.542985995444, 13471.797923031358, 14148.22184779847, 14213.857861421253, 13090.0, 13382.598522044354, 13529.59411217665, 13592.66018349549, 13920.721585568435, 11417.200795944203, 11517.42412879336, 11651.650450486499, 11668.968532337154, 11831.881681183078, 11460.140489463156, 11524.308541487537, 11534.769304613694, 11547.4803633835, 11647.708807279885], "value": 7154.689162139852, "unit": "score"}], "name": "dromaeo_css", "value": 7592.53180277466, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 113.0, 107.0, 109.0, 113.0, 112.0, 103.0, 110.0, 110.0, 111.0], "value": 109.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 136.0, 163.0, 176.0, 127.0, 155.0, 156.0, 128.0, 193.0, 128.0], "value": 151.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 162.0, 162.0, 162.0, 163.0, 161.0, 162.0, 161.0, 162.0, 164.0], "value": 162.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 76.0, 173.0, 76.0, 76.0, 75.0, 77.0, 172.0, 76.0], "value": 95.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 92.0, 150.0, 92.0, 92.0, 91.0, 145.0, 92.0, 98.0, 144.0], "value": 108.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 117.0, 117.0, 118.0, 118.0, 118.0, 117.0, 117.0, 119.0], "value": 117.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 148.0, 146.0, 146.0, 147.0, 146.0, 146.0, 148.0, 146.0], "value": 146.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 96.0, 96.0, 96.0, 95.0, 95.0, 96.0, 96.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 58.0, 57.0, 56.0, 57.0, 56.0, 58.0, 69.0, 54.0, 54.0], "value": 57.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 58.0, 58.0, 57.0, 58.0, 58.0, 57.0, 58.0, 58.0, 57.0], "value": 57.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 71.0, 72.0, 73.0, 80.0, 75.0, 81.0, 74.0, 74.0, 73.0], "value": 74.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 114.0, 116.0, 113.0, 115.0, 125.0, 120.0, 116.0, 125.0, 125.0], "value": 118.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 163.0, 156.0, 161.0, 160.0, 155.0, 157.0, 157.0, 167.0, 156.0], "value": 160.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 64.0, 66.0, 67.0, 68.0, 65.0, 67.0, 71.0, 75.0, 76.0], "value": 68.5, "unit": "score"}], "name": "kraken", "value": 1524.4, "alertThreshold": 2.0}]} 03:44:48 INFO - Return code: 0 03:44:48 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 03:44:48 ERROR - # TBPL SUCCESS # 03:44:48 INFO - Running post-action listener: _resource_record_post_action 03:44:48 INFO - Running post-run listener: _resource_record_post_run 03:44:49 INFO - Total resource usage - Wall time: 1185s; CPU: 13.0%; Read bytes: 266240; Write bytes: 503169024; Read time: 24; Write time: 458812 03:44:49 INFO - install - Wall time: 16s; CPU: 15.0%; Read bytes: 0; Write bytes: 248754176; Read time: 0; Write time: 338092 03:44:49 INFO - run-tests - Wall time: 1170s; CPU: 13.0%; Read bytes: 266240; Write bytes: 253816832; Read time: 24; Write time: 120720 03:44:49 INFO - Running post-run listener: _upload_blobber_files 03:44:49 INFO - Blob upload gear active. 03:44:49 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:44:49 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 03:44:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:44:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:44:49 INFO - (blobuploader) - INFO - Open directory for files ... 03:44:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 03:44:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:44:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:44:50 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 03:44:50 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:44:50 INFO - (blobuploader) - INFO - Done attempting. 03:44:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 03:44:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:44:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:44:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 03:44:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:44:51 INFO - (blobuploader) - INFO - Done attempting. 03:44:51 INFO - (blobuploader) - INFO - Iteration through files over. 03:44:51 INFO - Return code: 0 03:44:51 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:44:51 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:44:51 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0697082df18d253218b3646ae916b259311989de04d863b076ecedcce1d004171560570dc0a94035ce05b223e09e1ddb41e0b7b74553c801e2aedd573ec6eaab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/85a953839428be9267895a8f8b75d752ffecbbd13794e314742bfabaa8f228e5dbd99094963ab7056f23bbc23d0a68e79891aadb73a047f48a40919d158360c1"} 03:44:51 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:44:51 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:44:51 INFO - Contents: 03:44:51 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0697082df18d253218b3646ae916b259311989de04d863b076ecedcce1d004171560570dc0a94035ce05b223e09e1ddb41e0b7b74553c801e2aedd573ec6eaab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/85a953839428be9267895a8f8b75d752ffecbbd13794e314742bfabaa8f228e5dbd99094963ab7056f23bbc23d0a68e79891aadb73a047f48a40919d158360c1"} 03:44:51 INFO - Running post-run listener: copy_logs_to_upload_dir 03:44:51 INFO - Copying logs to upload dir... 03:44:51 INFO - mkdir: /builds/slave/test/build/upload/logs 03:44:51 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.071909 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-06-03 03:44:50.927559) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-03 03:44:50.931079) ========= 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=2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0697082df18d253218b3646ae916b259311989de04d863b076ecedcce1d004171560570dc0a94035ce05b223e09e1ddb41e0b7b74553c801e2aedd573ec6eaab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/85a953839428be9267895a8f8b75d752ffecbbd13794e314742bfabaa8f228e5dbd99094963ab7056f23bbc23d0a68e79891aadb73a047f48a40919d158360c1"} build_url:https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011620 build_url: 'https://queue.taskcluster.net/v1/task/KNJgZBlnRNyZS-DeJqNumA/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0697082df18d253218b3646ae916b259311989de04d863b076ecedcce1d004171560570dc0a94035ce05b223e09e1ddb41e0b7b74553c801e2aedd573ec6eaab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/85a953839428be9267895a8f8b75d752ffecbbd13794e314742bfabaa8f228e5dbd99094963ab7056f23bbc23d0a68e79891aadb73a047f48a40919d158360c1"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-03 03:44:50.957154) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-03 03:44:50.957532) ========= 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=2c5dd2b0a310ecf02fd87158000001b4-1464943281.467816-1668791931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004450 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-03 03:44:51.041464) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-03 03:44:51.041783) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-03 03:44:51.042061) ========= ========= Total master_lag: 0.19 =========