builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-055 starttime: 1460897833.2 results: success (0) buildid: 20160417030601 builduid: c47ad0463ea84d4994e6432533896f26 revision: 1da1937a9e03154ae7c60089f2dcf5ad9ee20fa3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.197501) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.198199) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.198601) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.280821) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.281155) ========= 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=82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-17 05:57:13-- 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% 88.8M=0s 2016-04-17 05:57:13 (88.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.135811 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.470076) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.470412) ========= 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=82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.156355 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.641717) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:13.642438) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 1da1937a9e03154ae7c60089f2dcf5ad9ee20fa3 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 1da1937a9e03154ae7c60089f2dcf5ad9ee20fa3 --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=82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-17 05:57:13,744 truncating revision to first 12 chars 2016-04-17 05:57:13,744 Setting DEBUG logging. 2016-04-17 05:57:13,744 attempt 1/10 2016-04-17 05:57:13,744 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/1da1937a9e03?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-17 05:57:14,026 unpacking tar archive at: mozilla-central-1da1937a9e03/testing/mozharness/ program finished with exit code 0 elapsedTime=0.902788 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:14.569600) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:14.569925) ========= script_repo_revision: 1da1937a9e03154ae7c60089f2dcf5ad9ee20fa3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:14.570477) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:14.570792) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-17 05:57:14.583121) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-04-17 05:57:14.583442) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:57:14 INFO - MultiFileLogger online at 20160417 05:57:14 in /builds/slave/test 05:57:14 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 05:57:14 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:57:14 INFO - {'append_to_log': False, 05:57:14 INFO - 'base_work_dir': '/builds/slave/test', 05:57:14 INFO - 'blob_upload_branch': 'Firefox', 05:57:14 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:57:14 INFO - 'branch': 'Firefox', 05:57:14 INFO - 'buildbot_json_path': 'buildprops.json', 05:57:14 INFO - 'config_files': ('talos/linux_config.py',), 05:57:14 INFO - 'default_actions': ('clobber', 05:57:14 INFO - 'read-buildbot-config', 05:57:14 INFO - 'download-and-extract', 05:57:14 INFO - 'populate-webroot', 05:57:14 INFO - 'create-virtualenv', 05:57:14 INFO - 'install', 05:57:14 INFO - 'run-tests'), 05:57:14 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:57:14 INFO - 'download_minidump_stackwalk': True, 05:57:14 INFO - 'download_symbols': 'ondemand', 05:57:14 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:57:14 INFO - 'tooltool.py': '/tools/tooltool.py', 05:57:14 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:57:14 INFO - '/tools/misc-python/virtualenv.py')}, 05:57:14 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:57:14 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:57:14 INFO - 'installer_path': 'installer.exe', 05:57:14 INFO - 'log_level': 'info', 05:57:14 INFO - 'log_name': 'talos', 05:57:14 INFO - 'log_to_console': True, 05:57:14 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:57:14 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:57:14 INFO - 'opt_config_files': (), 05:57:14 INFO - 'pip_index': False, 05:57:14 INFO - 'sps_profile': False, 05:57:14 INFO - 'sps_profile_interval': 0, 05:57:14 INFO - 'suite': 'dromaeojs-e10s', 05:57:14 INFO - 'system_bits': '32', 05:57:14 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:57:14 INFO - 'title': 'talos-linux64-ix-055', 05:57:14 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:57:14 INFO - 'use_talos_json': True, 05:57:14 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:57:14 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:57:14 INFO - 'work_dir': 'build'} 05:57:14 INFO - ##### 05:57:14 INFO - ##### Running clobber step. 05:57:14 INFO - ##### 05:57:14 INFO - Running pre-action listener: _resource_record_pre_action 05:57:14 INFO - Running main action method: clobber 05:57:14 INFO - rmtree: /builds/slave/test/build 05:57:14 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:57:15 INFO - Running post-action listener: _resource_record_post_action 05:57:15 INFO - ##### 05:57:15 INFO - ##### Running read-buildbot-config step. 05:57:15 INFO - ##### 05:57:15 INFO - Running pre-action listener: _resource_record_pre_action 05:57:15 INFO - Running main action method: read_buildbot_config 05:57:15 INFO - Using buildbot properties: 05:57:15 INFO - { 05:57:15 INFO - "project": "", 05:57:15 INFO - "product": "firefox", 05:57:15 INFO - "script_repo_revision": "production", 05:57:15 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 05:57:15 INFO - "repository": "", 05:57:15 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 05:57:15 INFO - "buildid": "20160417030601", 05:57:15 INFO - "stage_platform": "linux64-pgo", 05:57:15 INFO - "basedir": "/builds/slave/test", 05:57:15 INFO - "nightly_build": "True", 05:57:15 INFO - "buildnumber": 701, 05:57:15 INFO - "slavename": "talos-linux64-ix-055", 05:57:15 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 05:57:15 INFO - "platform": "ubuntu64_hw", 05:57:15 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 05:57:15 INFO - "branch": "mozilla-central", 05:57:15 INFO - "repo_path": "mozilla-central", 05:57:15 INFO - "revision": "1da1937a9e03154ae7c60089f2dcf5ad9ee20fa3", 05:57:15 INFO - "pgo_build": "True", 05:57:15 INFO - "builduid": "c47ad0463ea84d4994e6432533896f26", 05:57:15 INFO - "slavebuilddir": "test" 05:57:15 INFO - } 05:57:15 INFO - Found installer url https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 05:57:15 INFO - Running post-action listener: _resource_record_post_action 05:57:15 INFO - ##### 05:57:15 INFO - ##### Running download-and-extract step. 05:57:15 INFO - ##### 05:57:15 INFO - Running pre-action listener: _resource_record_pre_action 05:57:15 INFO - Running main action method: download_and_extract 05:57:15 INFO - mkdir: /builds/slave/test/build/tests 05:57:15 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')]} 05:57:15 INFO - https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 05:57:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 05:57:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 05:57:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 05:57:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 05:57:18 INFO - Downloaded 1361 bytes. 05:57:18 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 05:57:18 INFO - Using the following test package requirements: 05:57:18 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 05:57:18 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:57:18 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:57:18 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:57:18 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:57:18 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:57:18 INFO - u'jsshell-linux-x86_64.zip'], 05:57:18 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:57:18 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:57:18 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 05:57:18 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:57:18 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:57:18 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:57:18 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:57:18 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:57:18 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:57:18 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 05:57:18 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:57:18 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:57: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')]} 05:57:18 INFO - https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:57:18 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:57:18 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:57:18 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:57:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:57:20 INFO - Downloaded 23774889 bytes. 05:57:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:57:20 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 05:57:21 INFO - Return code: 0 05:57:21 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:57:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:21 INFO - https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:57:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:57:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:57:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 05:57:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:57:24 INFO - Downloaded 23774889 bytes. 05:57:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:57:24 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 05:57:26 INFO - Return code: 0 05:57:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:26 INFO - https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:57:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 05:57:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 05:57:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 05:57:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:57:27 INFO - Downloaded 10841076 bytes. 05:57:27 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:57:27 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 05:57:27 INFO - Return code: 0 05:57:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:27 INFO - https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:57:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:57:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:57:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:57:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:57:29 INFO - Downloaded 58235185 bytes. 05:57:29 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:57:29 INFO - mkdir: /builds/slave/test/properties 05:57:29 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:57:29 INFO - Writing to file /builds/slave/test/properties/build_url 05:57:29 INFO - Contents: 05:57:29 INFO - build_url:https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 05:57:30 INFO - Running post-action listener: _resource_record_post_action 05:57:30 INFO - Running post-action listener: set_extra_try_arguments 05:57:30 INFO - ##### 05:57:30 INFO - ##### Running populate-webroot step. 05:57:30 INFO - ##### 05:57:30 INFO - Running pre-action listener: _resource_record_pre_action 05:57:30 INFO - Running main action method: populate_webroot 05:57:30 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:57:30 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:57:30 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:57:30 INFO - '--tppagecycles', 05:57:30 INFO - '7'], 05:57:30 INFO - 'tests': ['tsvgm']}}, 05:57:30 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:57:30 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:57:30 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:57:30 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:57:30 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:57:30 INFO - 'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:57:30 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:57:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:57:30 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:57:30 INFO - 'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['damp', 'tps']}, 05:57:30 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:57:30 INFO - 'tests': ['damp', 'tps']}, 05:57:30 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['dromaeo_dom']}, 05:57:30 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:57:30 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['a11yr', 05:57:30 INFO - 'ts_paint', 05:57:30 INFO - 'tpaint', 05:57:30 INFO - 'sessionrestore', 05:57:30 INFO - 'sessionrestore_no_auto_restore', 05:57:30 INFO - 'tabpaint']}, 05:57:30 INFO - 'other-e10s': {'tests': ['a11yr', 05:57:30 INFO - 'ts_paint', 05:57:30 INFO - 'tpaint', 05:57:30 INFO - 'sessionrestore', 05:57:30 INFO - 'sessionrestore_no_auto_restore', 05:57:30 INFO - 'tabpaint']}, 05:57:30 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:57:30 INFO - 'ts_paint', 05:57:30 INFO - 'tpaint', 05:57:30 INFO - 'sessionrestore', 05:57:30 INFO - 'sessionrestore_no_auto_restore', 05:57:30 INFO - 'tabpaint']}, 05:57:30 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:57:30 INFO - 'ts_paint', 05:57:30 INFO - 'tpaint', 05:57:30 INFO - 'sessionrestore', 05:57:30 INFO - 'sessionrestore_no_auto_restore', 05:57:30 INFO - 'tabpaint']}, 05:57:30 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['a11yr', 05:57:30 INFO - 'ts_paint', 05:57:30 INFO - 'tpaint', 05:57:30 INFO - 'sessionrestore', 05:57:30 INFO - 'sessionrestore_no_auto_restore', 05:57:30 INFO - 'tabpaint']}, 05:57:30 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['a11yr', 05:57:30 INFO - 'ts_paint', 05:57:30 INFO - 'tpaint', 05:57:30 INFO - 'sessionrestore', 05:57:30 INFO - 'sessionrestore_no_auto_restore', 05:57:30 INFO - 'tabpaint']}, 05:57:30 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['tsvgx', 05:57:30 INFO - 'tsvgr_opacity', 05:57:30 INFO - 'tart', 05:57:30 INFO - 'tscrollx', 05:57:30 INFO - 'cart']}, 05:57:30 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:57:30 INFO - 'tsvgr_opacity', 05:57:30 INFO - 'tart', 05:57:30 INFO - 'tscrollx', 05:57:30 INFO - 'cart']}, 05:57:30 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:57:30 INFO - 'talos_options': ['--disable-e10s'], 05:57:30 INFO - 'tests': ['tp5o']}, 05:57:30 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:57:30 INFO - 'tests': ['tp5o']}, 05:57:30 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:57:30 INFO - 'talos_options': ['--disable-e10s', 05:57:30 INFO - '--xperf_path', 05:57:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:57:30 INFO - 'tests': ['tp5n']}, 05:57:30 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:57:30 INFO - 'talos_options': ['--xperf_path', 05:57:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:57:30 INFO - 'tests': ['tp5n']}}, 05:57:30 INFO - 'talos.zip': {'path': '', 05:57:30 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:57:30 INFO - Running post-action listener: _resource_record_post_action 05:57:30 INFO - ##### 05:57:30 INFO - ##### Running create-virtualenv step. 05:57:30 INFO - ##### 05:57:30 INFO - Running pre-action listener: _resource_record_pre_action 05:57:30 INFO - Running main action method: create_virtualenv 05:57:30 INFO - Creating virtualenv /builds/slave/test/build/venv 05:57:30 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 05:57:30 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:57:30 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:57:30 INFO - Using real prefix '/usr' 05:57:30 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:57:31 INFO - Installing distribute.............................................................................................................................................................................................done. 05:57:33 INFO - Installing pip.................done. 05:57:33 INFO - Return code: 0 05:57:33 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:57:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:33 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 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:33 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 05:57:33 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 05:57:33 INFO - Using env: {'DISPLAY': ':0', 05:57:33 INFO - 'HOME': '/home/cltbld', 05:57:33 INFO - 'LANG': 'en_US.UTF-8', 05:57:33 INFO - 'LANGUAGE': 'en_US:en', 05:57:33 INFO - 'LOGNAME': 'cltbld', 05:57:33 INFO - 'MAIL': '/var/mail/cltbld', 05:57:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:33 INFO - 'MOZ_NO_REMOTE': '1', 05:57:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:33 INFO - 'NO_EM_RESTART': '1', 05:57:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:33 INFO - 'PWD': '/builds/slave/test', 05:57:33 INFO - 'SHELL': '/bin/bash', 05:57:33 INFO - 'SHLVL': '1', 05:57:33 INFO - 'TERM': 'linux', 05:57:33 INFO - 'TMOUT': '86400', 05:57:33 INFO - 'USER': 'cltbld', 05:57:33 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:33 INFO - '_': '/tools/buildbot/bin/python'} 05:57:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:33 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 05:57:33 INFO - Cleaning up... 05:57:33 INFO - Return code: 0 05:57:33 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:57:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:33 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 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:33 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 05:57:33 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 05:57:33 INFO - Using env: {'DISPLAY': ':0', 05:57:33 INFO - 'HOME': '/home/cltbld', 05:57:33 INFO - 'LANG': 'en_US.UTF-8', 05:57:33 INFO - 'LANGUAGE': 'en_US:en', 05:57:33 INFO - 'LOGNAME': 'cltbld', 05:57:33 INFO - 'MAIL': '/var/mail/cltbld', 05:57:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:33 INFO - 'MOZ_NO_REMOTE': '1', 05:57:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:33 INFO - 'NO_EM_RESTART': '1', 05:57:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:33 INFO - 'PWD': '/builds/slave/test', 05:57:33 INFO - 'SHELL': '/bin/bash', 05:57:33 INFO - 'SHLVL': '1', 05:57:33 INFO - 'TERM': 'linux', 05:57:33 INFO - 'TMOUT': '86400', 05:57:33 INFO - 'USER': 'cltbld', 05:57:33 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:33 INFO - '_': '/tools/buildbot/bin/python'} 05:57:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:34 INFO - Downloading/unpacking psutil>=0.7.1 05:57:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:57:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:57:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:57:36 INFO - Installing collected packages: psutil 05:57:36 INFO - Running setup.py install for psutil 05:57:36 INFO - building 'psutil._psutil_linux' extension 05:57:36 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 05:57:38 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 05:57:38 INFO - building 'psutil._psutil_posix' extension 05:57:38 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 05:57:38 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 05:57:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:57:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:57:38 INFO - Successfully installed psutil 05:57:38 INFO - Cleaning up... 05:57:38 INFO - Return code: 0 05:57:38 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:57:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 05:57:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 05:57:38 INFO - Using env: {'DISPLAY': ':0', 05:57:38 INFO - 'HOME': '/home/cltbld', 05:57:38 INFO - 'LANG': 'en_US.UTF-8', 05:57:38 INFO - 'LANGUAGE': 'en_US:en', 05:57:38 INFO - 'LOGNAME': 'cltbld', 05:57:38 INFO - 'MAIL': '/var/mail/cltbld', 05:57:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:38 INFO - 'MOZ_NO_REMOTE': '1', 05:57:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:38 INFO - 'NO_EM_RESTART': '1', 05:57:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:38 INFO - 'PWD': '/builds/slave/test', 05:57:38 INFO - 'SHELL': '/bin/bash', 05:57:38 INFO - 'SHLVL': '1', 05:57:38 INFO - 'TERM': 'linux', 05:57:38 INFO - 'TMOUT': '86400', 05:57:38 INFO - 'USER': 'cltbld', 05:57:38 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:38 INFO - '_': '/tools/buildbot/bin/python'} 05:57:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:38 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:57:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:40 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:57:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:57:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:57:40 INFO - Installing collected packages: mozsystemmonitor 05:57:40 INFO - Running setup.py install for mozsystemmonitor 05:57:40 INFO - Successfully installed mozsystemmonitor 05:57:40 INFO - Cleaning up... 05:57:40 INFO - Return code: 0 05:57:40 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:57: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')]} 05:57:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57: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')]} 05:57:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 05:57:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:57:40 INFO - Using env: {'DISPLAY': ':0', 05:57:40 INFO - 'HOME': '/home/cltbld', 05:57:40 INFO - 'LANG': 'en_US.UTF-8', 05:57:40 INFO - 'LANGUAGE': 'en_US:en', 05:57:40 INFO - 'LOGNAME': 'cltbld', 05:57:40 INFO - 'MAIL': '/var/mail/cltbld', 05:57:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:40 INFO - 'MOZ_NO_REMOTE': '1', 05:57:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:40 INFO - 'NO_EM_RESTART': '1', 05:57:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:40 INFO - 'PWD': '/builds/slave/test', 05:57:40 INFO - 'SHELL': '/bin/bash', 05:57:40 INFO - 'SHLVL': '1', 05:57:40 INFO - 'TERM': 'linux', 05:57:40 INFO - 'TMOUT': '86400', 05:57:40 INFO - 'USER': 'cltbld', 05:57:40 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:40 INFO - '_': '/tools/buildbot/bin/python'} 05:57:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:41 INFO - Downloading/unpacking blobuploader==1.2.4 05:57: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 05:57: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 05:57: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 05:57: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 05:57: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 05:57: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 05:57:42 INFO - Downloading blobuploader-1.2.4.tar.gz 05:57:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:57:42 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:57:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:57:43 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:57: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 05:57: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 05:57: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 05:57: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 05:57: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 05:57: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 05:57:43 INFO - Downloading docopt-0.6.1.tar.gz 05:57:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:57:43 INFO - Installing collected packages: blobuploader, requests, docopt 05:57:43 INFO - Running setup.py install for blobuploader 05:57:43 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:57:43 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:57:43 INFO - Running setup.py install for requests 05:57:44 INFO - Running setup.py install for docopt 05:57:44 INFO - Successfully installed blobuploader requests docopt 05:57:44 INFO - Cleaning up... 05:57:44 INFO - Return code: 0 05:57:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:57:44 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')]} 05:57:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:44 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')]} 05:57:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:44 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 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:44 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 05:57:44 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 05:57:44 INFO - Using env: {'DISPLAY': ':0', 05:57:44 INFO - 'HOME': '/home/cltbld', 05:57:44 INFO - 'LANG': 'en_US.UTF-8', 05:57:44 INFO - 'LANGUAGE': 'en_US:en', 05:57:44 INFO - 'LOGNAME': 'cltbld', 05:57:44 INFO - 'MAIL': '/var/mail/cltbld', 05:57:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:44 INFO - 'MOZ_NO_REMOTE': '1', 05:57:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:44 INFO - 'NO_EM_RESTART': '1', 05:57:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:44 INFO - 'PWD': '/builds/slave/test', 05:57:44 INFO - 'SHELL': '/bin/bash', 05:57:44 INFO - 'SHLVL': '1', 05:57:44 INFO - 'TERM': 'linux', 05:57:44 INFO - 'TMOUT': '86400', 05:57:44 INFO - 'USER': 'cltbld', 05:57:44 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:44 INFO - '_': '/tools/buildbot/bin/python'} 05:57:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:57:44 INFO - Running setup.py (path:/tmp/pip-eACI8_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:57:44 INFO - Running setup.py (path:/tmp/pip-TKjA52-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:57:44 INFO - Running setup.py (path:/tmp/pip-gDRoMq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:57:44 INFO - Running setup.py (path:/tmp/pip-jOAmLk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:57:44 INFO - Running setup.py (path:/tmp/pip-4z37eF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:57:44 INFO - Running setup.py (path:/tmp/pip-DyWZ5d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:57:44 INFO - Running setup.py (path:/tmp/pip-BvA30d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:57:44 INFO - Running setup.py (path:/tmp/pip-NLYCMP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:57:45 INFO - Running setup.py (path:/tmp/pip-brNL7U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:57:45 INFO - Running setup.py (path:/tmp/pip-2oRjyQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:57:45 INFO - Running setup.py (path:/tmp/pip-I6NZRL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:57:45 INFO - Running setup.py (path:/tmp/pip-C165bN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:57:45 INFO - Running setup.py (path:/tmp/pip-Ea_ki4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:57:45 INFO - Running setup.py (path:/tmp/pip-aU_bUG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:57:45 INFO - Running setup.py (path:/tmp/pip-d7mJkc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:57:45 INFO - Running setup.py (path:/tmp/pip-sjkJn6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:57:45 INFO - Running setup.py (path:/tmp/pip-LCzsj3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:57:45 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:57:45 INFO - Running setup.py install for manifestparser 05:57:45 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:57:45 INFO - Running setup.py install for mozcrash 05:57:45 INFO - Running setup.py install for mozdebug 05:57:45 INFO - Running setup.py install for mozdevice 05:57:46 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Running setup.py install for mozfile 05:57:46 INFO - Running setup.py install for mozhttpd 05:57:46 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Running setup.py install for mozinfo 05:57:46 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Running setup.py install for mozInstall 05:57:46 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Running setup.py install for mozleak 05:57:46 INFO - Running setup.py install for mozlog 05:57:46 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Running setup.py install for moznetwork 05:57:46 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:57:46 INFO - Running setup.py install for mozprocess 05:57:46 INFO - Running setup.py install for mozprofile 05:57:47 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:57:47 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:57:47 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:57:47 INFO - Running setup.py install for mozrunner 05:57:47 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:57:47 INFO - Running setup.py install for mozscreenshot 05:57:47 INFO - Running setup.py install for moztest 05:57:47 INFO - Running setup.py install for mozversion 05:57:47 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:57:47 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:57:47 INFO - Cleaning up... 05:57:47 INFO - Return code: 0 05:57:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:57:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:57:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:57:47 INFO - Using env: {'DISPLAY': ':0', 05:57:47 INFO - 'HOME': '/home/cltbld', 05:57:47 INFO - 'LANG': 'en_US.UTF-8', 05:57:47 INFO - 'LANGUAGE': 'en_US:en', 05:57:47 INFO - 'LOGNAME': 'cltbld', 05:57:47 INFO - 'MAIL': '/var/mail/cltbld', 05:57:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:47 INFO - 'MOZ_NO_REMOTE': '1', 05:57:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:47 INFO - 'NO_EM_RESTART': '1', 05:57:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:47 INFO - 'PWD': '/builds/slave/test', 05:57:47 INFO - 'SHELL': '/bin/bash', 05:57:47 INFO - 'SHLVL': '1', 05:57:47 INFO - 'TERM': 'linux', 05:57:47 INFO - 'TMOUT': '86400', 05:57:47 INFO - 'USER': 'cltbld', 05:57:47 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:47 INFO - '_': '/tools/buildbot/bin/python'} 05:57:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:57:47 INFO - Running setup.py (path:/tmp/pip-ewUZyw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:57:47 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 05:57:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:57:47 INFO - Running setup.py (path:/tmp/pip-lvOSHt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:57:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:57:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:57:47 INFO - Running setup.py (path:/tmp/pip-tmQHQ_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:57:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:57:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:57:47 INFO - Running setup.py (path:/tmp/pip-F6QmKW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:57:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:57:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:57:47 INFO - Running setup.py (path:/tmp/pip-Nfzolw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:57:48 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)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:57:48 INFO - Running setup.py (path:/tmp/pip-3EHeX_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:57:48 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)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:57:48 INFO - Running setup.py (path:/tmp/pip-D8kUV3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:57:48 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)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:57:48 INFO - Running setup.py (path:/tmp/pip-SxOGJd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:57:48 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)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:57:48 INFO - Running setup.py (path:/tmp/pip-rfqhN0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:57:48 INFO - Running setup.py (path:/tmp/pip-XF7lYK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:57:48 INFO - Running setup.py (path:/tmp/pip-n5xorw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:57:48 INFO - Running setup.py (path:/tmp/pip-j1j_WD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:57:48 INFO - Running setup.py (path:/tmp/pip-FLHSxu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:57:48 INFO - Running setup.py (path:/tmp/pip-l5FH6Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:57:48 INFO - Running setup.py (path:/tmp/pip-iSFHWD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:57:48 INFO - Running setup.py (path:/tmp/pip-mvog_b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 05:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:57:48 INFO - Running setup.py (path:/tmp/pip-eawp9e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:57:48 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:57: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 05:57: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 05:57: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 05:57: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 05:57: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 05:57: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 05:57:50 INFO - Downloading blessings-1.6.tar.gz 05:57:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:57:50 INFO - Installing collected packages: blessings 05:57:50 INFO - Running setup.py install for blessings 05:57:50 INFO - Successfully installed blessings 05:57:50 INFO - Cleaning up... 05:57:51 INFO - Return code: 0 05:57:51 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:57:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:57:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:57:51 INFO - Reading from file tmpfile_stdout 05:57:51 INFO - Current package versions: 05:57:51 INFO - argparse == 1.2.1 05:57:51 INFO - blessings == 1.6 05:57:51 INFO - blobuploader == 1.2.4 05:57:51 INFO - docopt == 0.6.1 05:57:51 INFO - manifestparser == 1.1 05:57:51 INFO - mozInstall == 1.12 05:57:51 INFO - mozcrash == 0.17 05:57:51 INFO - mozdebug == 0.1 05:57:51 INFO - mozdevice == 0.48 05:57:51 INFO - mozfile == 1.2 05:57:51 INFO - mozhttpd == 0.7 05:57:51 INFO - mozinfo == 0.9 05:57:51 INFO - mozleak == 0.1 05:57:51 INFO - mozlog == 3.1 05:57:51 INFO - moznetwork == 0.27 05:57:51 INFO - mozprocess == 0.22 05:57:51 INFO - mozprofile == 0.28 05:57:51 INFO - mozrunner == 6.11 05:57:51 INFO - mozscreenshot == 0.1 05:57:51 INFO - mozsystemmonitor == 0.0 05:57:51 INFO - moztest == 0.7 05:57:51 INFO - mozversion == 1.4 05:57:51 INFO - psutil == 3.1.1 05:57:51 INFO - requests == 1.2.3 05:57:51 INFO - wsgiref == 0.1.2 05:57:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:57:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:51 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 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:51 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 05:57:51 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 05:57:51 INFO - Using env: {'DISPLAY': ':0', 05:57:51 INFO - 'HOME': '/home/cltbld', 05:57:51 INFO - 'LANG': 'en_US.UTF-8', 05:57:51 INFO - 'LANGUAGE': 'en_US:en', 05:57:51 INFO - 'LOGNAME': 'cltbld', 05:57:51 INFO - 'MAIL': '/var/mail/cltbld', 05:57:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:51 INFO - 'MOZ_NO_REMOTE': '1', 05:57:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:51 INFO - 'NO_EM_RESTART': '1', 05:57:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:51 INFO - 'PWD': '/builds/slave/test', 05:57:51 INFO - 'SHELL': '/bin/bash', 05:57:51 INFO - 'SHLVL': '1', 05:57:51 INFO - 'TERM': 'linux', 05:57:51 INFO - 'TMOUT': '86400', 05:57:51 INFO - 'USER': 'cltbld', 05:57:51 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:51 INFO - '_': '/tools/buildbot/bin/python'} 05:57:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:57:51 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:57:51 INFO - Cleaning up... 05:57:51 INFO - Return code: 0 05:57:51 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:57:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 05:57:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:57:51 INFO - Using env: {'DISPLAY': ':0', 05:57:51 INFO - 'HOME': '/home/cltbld', 05:57:51 INFO - 'LANG': 'en_US.UTF-8', 05:57:51 INFO - 'LANGUAGE': 'en_US:en', 05:57:51 INFO - 'LOGNAME': 'cltbld', 05:57:51 INFO - 'MAIL': '/var/mail/cltbld', 05:57:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:51 INFO - 'MOZ_NO_REMOTE': '1', 05:57:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:51 INFO - 'NO_EM_RESTART': '1', 05:57:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:51 INFO - 'PWD': '/builds/slave/test', 05:57:51 INFO - 'SHELL': '/bin/bash', 05:57:51 INFO - 'SHLVL': '1', 05:57:51 INFO - 'TERM': 'linux', 05:57:51 INFO - 'TMOUT': '86400', 05:57:51 INFO - 'USER': 'cltbld', 05:57:51 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:51 INFO - '_': '/tools/buildbot/bin/python'} 05:57:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:51 INFO - Downloading/unpacking jsonschema 05:57:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:53 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:57:53 INFO - Downloading/unpacking functools32 (from jsonschema) 05:57:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:53 INFO - Downloading functools32-3.2.3-2.tar.gz 05:57:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:57:53 INFO - warning: no files found matching '*.txt' 05:57:53 INFO - no previously-included directories found matching 'build' 05:57:53 INFO - no previously-included directories found matching 'dist' 05:57:53 INFO - no previously-included directories found matching '.git*' 05:57:53 INFO - Installing collected packages: jsonschema, functools32 05:57:53 INFO - Running setup.py install for functools32 05:57:53 INFO - warning: no files found matching '*.txt' 05:57:53 INFO - no previously-included directories found matching 'build' 05:57:53 INFO - no previously-included directories found matching 'dist' 05:57:53 INFO - no previously-included directories found matching '.git*' 05:57:54 INFO - Successfully installed jsonschema functools32 05:57:54 INFO - Cleaning up... 05:57:54 INFO - Return code: 0 05:57:54 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 05:57:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:57:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:57:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:57:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:57:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd6ed32af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d8b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e565a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, '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': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', '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 05:57:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 05:57:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 05:57:54 INFO - Using env: {'DISPLAY': ':0', 05:57:54 INFO - 'HOME': '/home/cltbld', 05:57:54 INFO - 'LANG': 'en_US.UTF-8', 05:57:54 INFO - 'LANGUAGE': 'en_US:en', 05:57:54 INFO - 'LOGNAME': 'cltbld', 05:57:54 INFO - 'MAIL': '/var/mail/cltbld', 05:57:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:57:54 INFO - 'MOZ_NO_REMOTE': '1', 05:57:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:57:54 INFO - 'NO_EM_RESTART': '1', 05:57:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:57:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:57:54 INFO - 'PWD': '/builds/slave/test', 05:57:54 INFO - 'SHELL': '/bin/bash', 05:57:54 INFO - 'SHLVL': '1', 05:57:54 INFO - 'TERM': 'linux', 05:57:54 INFO - 'TMOUT': '86400', 05:57:54 INFO - 'USER': 'cltbld', 05:57:54 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:57:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:57:54 INFO - '_': '/tools/buildbot/bin/python'} 05:57:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:57:54 INFO - Downloading/unpacking flake8 05:57: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 05:57: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 05:57: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 05:57: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 05:57: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 05:57: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 05:57:56 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:57:56 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:57:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:56 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:57:56 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:57:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:56 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:57:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:57:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:57:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:57:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 05:57:56 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:57:56 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:57:56 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:57:56 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:57:56 INFO - no previously-included directories found matching 'docs/_build' 05:57:56 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:57:56 INFO - Running setup.py install for pep8 05:57:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:57:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:57:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:57:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:57:57 INFO - no previously-included directories found matching 'docs/_build' 05:57:57 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 05:57:57 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:57:57 INFO - Cleaning up... 05:57:57 INFO - Return code: 0 05:57:57 INFO - Running post-action listener: _resource_record_post_action 05:57:57 INFO - Running post-action listener: _start_resource_monitoring 05:57:57 INFO - Starting resource monitoring. 05:57:57 INFO - ##### 05:57:57 INFO - ##### Running install step. 05:57:57 INFO - ##### 05:57:57 INFO - Running pre-action listener: _resource_record_pre_action 05:57:57 INFO - Running main action method: install 05:57:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:57:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:57:57 INFO - Reading from file tmpfile_stdout 05:57:57 INFO - Detecting whether we're running mozinstall >=1.0... 05:57:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:57:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:57:57 INFO - Reading from file tmpfile_stdout 05:57:57 INFO - Output received: 05:57:57 INFO - Usage: mozinstall [options] installer 05:57:57 INFO - Options: 05:57:57 INFO - -h, --help show this help message and exit 05:57:57 INFO - -d DEST, --destination=DEST 05:57:57 INFO - Directory to install application into. [default: 05:57:57 INFO - "/builds/slave/test"] 05:57:57 INFO - --app=APP Application being installed. [default: firefox] 05:57:57 INFO - mkdir: /builds/slave/test/build/application 05:57:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:57:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 05:58:13 INFO - Reading from file tmpfile_stdout 05:58:13 INFO - Output received: 05:58:13 INFO - /builds/slave/test/build/application/firefox/firefox 05:58:13 INFO - Running post-action listener: _resource_record_post_action 05:58:13 INFO - ##### 05:58:13 INFO - ##### Running run-tests step. 05:58:13 INFO - ##### 05:58:13 INFO - Running pre-action listener: _resource_record_pre_action 05:58:13 INFO - Running main action method: run_tests 05:58:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:58:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:58:13 INFO - Python 2.7.3 05:58:13 INFO - Return code: 0 05:58:13 INFO - grabbing minidump binary from tooltool 05:58:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:58:13 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 0x1ee5410>, '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 0x1ee6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee67a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:58:13 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 05:58:13 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 05:58:14 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:58:14 INFO - Return code: 0 05:58:14 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:58:14 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:58:14 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:58:14 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:58:14 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:58:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 05:58:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 05:58:15 INFO - Return code: 0 05:58:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-055', '--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 05:58:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-055 --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 05:58:15 INFO - Using env: {'DISPLAY': ':0', 05:58:15 INFO - 'HOME': '/home/cltbld', 05:58:15 INFO - 'LANG': 'en_US.UTF-8', 05:58:15 INFO - 'LANGUAGE': 'en_US:en', 05:58:15 INFO - 'LOGNAME': 'cltbld', 05:58:15 INFO - 'MAIL': '/var/mail/cltbld', 05:58:15 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:58:15 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:58:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:58:15 INFO - 'MOZ_NO_REMOTE': '1', 05:58:15 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:58:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:58:15 INFO - 'NO_EM_RESTART': '1', 05:58:15 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:58:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:58:15 INFO - 'PWD': '/builds/slave/test', 05:58:15 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:58:15 INFO - 'SHELL': '/bin/bash', 05:58:15 INFO - 'SHLVL': '1', 05:58:15 INFO - 'TERM': 'linux', 05:58:15 INFO - 'TMOUT': '86400', 05:58:15 INFO - 'USER': 'cltbld', 05:58:15 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949', 05:58:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:58:15 INFO - '_': '/tools/buildbot/bin/python'} 05:58:15 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-055', '--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 05:58:15 INFO - mozversion application_buildid: 20160417030601 05:58:15 INFO - mozversion application_changeset: 1da1937a9e03154ae7c60089f2dcf5ad9ee20fa3 05:58:15 INFO - mozversion application_display_name: Nightly 05:58:15 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:58:15 INFO - mozversion application_name: Firefox 05:58:15 INFO - mozversion application_remotingname: firefox 05:58:15 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 05:58:15 INFO - mozversion application_vendor: Mozilla 05:58:15 INFO - mozversion application_version: 48.0a1 05:58:15 INFO - mozversion platform_buildid: 20160417030601 05:58:15 INFO - mozversion platform_changeset: 1da1937a9e03154ae7c60089f2dcf5ad9ee20fa3 05:58:15 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 05:58:15 INFO - mozversion platform_version: 48.0a1 05:58:15 INFO - using testdate: 1460897895 05:58:15 INFO - actual date: 1460897895 05:58:15 INFO - starting webserver on 'localhost:48693' 05:58:15 INFO - SUITE-START | Running 2 tests 05:58:15 INFO - TEST-START | dromaeo_css 05:58:15 INFO - operating with platform_type : linux_ 05:58:15 INFO - Initialising browser for dromaeo_css test... 05:58:15 INFO - TEST-INFO | started process 3431 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjyn7Rp/profile http://localhost:48693/getInfo.html) 05:58:20 INFO - PROCESS | 3431 | 05:58:20 INFO - PROCESS | 3431 | (process:3500): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:58:21 INFO - PROCESS | 3431 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 05:58:21 INFO - PROCESS | 3431 | __metrics Screen width/height:1600/1200 05:58:21 INFO - PROCESS | 3431 | colorDepth:24 05:58:21 INFO - PROCESS | 3431 | Browser inner width/height: 1024/697 05:58:21 INFO - PROCESS | 3431 | __metrics 05:58:22 ERROR - PROCESS | 3431 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 05:58:23 INFO - TEST-INFO | 3431: exit 0 05:58:23 INFO - Browser initialized. 05:58:23 INFO - Running cycle 1/1 for dromaeo_css test... 05:58:23 INFO - TEST-INFO | started process 3551 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjyn7Rp/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:58:25 INFO - PROCESS | 3551 | 05:58:25 INFO - PROCESS | 3551 | (process:3612): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:58:35 INFO - PROCESS | 3551 | RSS: Main: 163766272 05:58:35 INFO - PROCESS | 3551 | 05:59:24 INFO - PROCESS | 3551 | 1460897964855 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] 06:01:32 INFO - PROCESS | 3551 | Cycle 1(1): loaded http://localhost:48693/tests/dromaeo/cssquery-dojo.html (next: http://localhost:48693/tests/dromaeo/cssquery-ext.html) 06:01:33 INFO - PROCESS | 3551 | RSS: Main: 168853504 06:01:33 INFO - PROCESS | 3551 | 06:04:35 INFO - PROCESS | 3551 | Cycle 1(1): loaded http://localhost:48693/tests/dromaeo/cssquery-ext.html (next: http://localhost:48693/tests/dromaeo/cssquery-jquery.html) 06:04:36 INFO - PROCESS | 3551 | RSS: Main: 165957632 06:04:36 INFO - PROCESS | 3551 | 06:07:37 INFO - PROCESS | 3551 | Cycle 1(1): loaded http://localhost:48693/tests/dromaeo/cssquery-jquery.html (next: http://localhost:48693/tests/dromaeo/cssquery-mootools.html) 06:07:38 INFO - PROCESS | 3551 | RSS: Main: 166387712 06:07:38 INFO - PROCESS | 3551 | 06:10:40 INFO - PROCESS | 3551 | Cycle 1(1): loaded http://localhost:48693/tests/dromaeo/cssquery-mootools.html (next: http://localhost:48693/tests/dromaeo/cssquery-prototype.html) 06:10:40 INFO - PROCESS | 3551 | RSS: Main: 164184064 06:10:40 INFO - PROCESS | 3551 | 06:13:43 INFO - PROCESS | 3551 | Cycle 1(1): loaded http://localhost:48693/tests/dromaeo/cssquery-prototype.html (next: http://localhost:48693/tests/dromaeo/cssquery-yui.html) 06:13:43 INFO - PROCESS | 3551 | RSS: Main: 166031360 06:13:43 INFO - PROCESS | 3551 | 06:16:45 INFO - PROCESS | 3551 | Cycle 1(1): loaded http://localhost:48693/tests/dromaeo/cssquery-yui.html (next: http://localhost:48693/tests/dromaeo/cssquery-dojo.html) 06:16:46 INFO - PROCESS | 3551 | RSS: Main: 167940096 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - PROCESS | 3551 | __start_tp_report 06:16:46 INFO - PROCESS | 3551 | _x_x_mozilla_page_load 06:16:46 INFO - PROCESS | 3551 | _x_x_mozilla_page_load_details 06:16:46 INFO - PROCESS | 3551 | |i|pagename|runs| 06:16:46 INFO - PROCESS | 3551 | |0;dojo.html;3008.0524634740054;3052.3284877326982;3061.433634777566;3078.6151731033606;3091.134482344944;5317.122674758665;5336.119540275849;5346.518813306801;5361.088614935461;5363.061464243757;5231.633785635007;5341.626086173969;5366.865828354293;5400.108982017962;5485.177223416489;4869.074875773601;4915.336429582015;4924.335214746017;5047.242913562976;5069.087564238435;4977.850664480054;4994.800207991676;4996.125678006352;4997.750112494379;5010.624203184758;4739.786709598059;4829.396325459317;4839.3466881970835;4904.215325547895;4971.05549945511;4887.242477416006;4890.951090489085;4909.386326709161;4914.557689807899;4931.4821943696115;4850.466448690641;4883.438404583483;4886.364772579542;4888.388951381077;4937;5264.552513036397;5286.04851126797;5316.73416329182;5321.201819727034;5334.03987282289;5670.461306175948;5677.176809362661;5701.971490142523;5737.8565535861935;5744.597878148531;5571.470710282517;5694.9715251423895;5738.741756620962;5777.277840269966;5792.304923409218;5308.522232999048;5316.4683531646915;5338.973305133488;5362.302900622894;5381.112116500773;5757.337906140764;5762.193292938992;5766.163906233573;5790.913136302959;5801.50687191585;5527.115661494142;5571.359293681197;5579.088338872064;5592.524635406036;5644.379118296984;5746.482816546531;5750.88498230033;5752.453516915886;5757;5778.046622307273;5566.721663916788;5614.606977511617;5657.32112146545;5660.943390566042;5699.857503562361;5482.616216864861;5553.6390134641115;5577.609567330248;5577.721113944368;5597.524210442158;4279.7218180818145;4284.10033892886;4289.1850548395705;4310.181065597527;4319;3839.462475253467;3840.8271627776817;3848.9615103848605;3867.16855875988;3880.4373365861793;5208.218767184952;5218.269442278084;5244.134717771525;5272.551833094153;5281.841544753664;5586.720663966867;5587.497125258747;5595.496405323541;5606.271184746039;5626.2967129108865;5231.058409486329;5248.396434410091;5250.1337279349245;5252;5291.417944026154;4787.16224660683;4823.541763532458;4856.660033797671;4877.414710234723;4886.438059623118;5887.411258874164;5899.380565040695;5906.586538942319;5930.792422265286;5932.911006334908;5693.288338957547;5701.800436984686;5702.401247868914;5704.80033198836;5712.200291959212;5741.8564535886935;5820.912686309624;5859.44335288147;5904.704764761831;5904.9704751475965;5539.833804985857;5553.944460555343;5564.02629539837;5570.275864137636;5574.108142697149;5590.245316882331;5595.412481689364;5613.354464236665;5616.522595579421;5624.100143977108;5352.732363381738;5489.3687225969525;5531.308586426697;5550.8057217997175;5576.219329293983;5536.75084621201;5537.612367134423;5581.162825576196;5596.160575913483;5638.464345887134;5403.378611459732;5489.64317319373;5519.586031047607;5519.724013799374;5525.889482210253;5515.862103447446;5596.916046259228;5621.55027597783;5627.718614069198;5686.57350698691;5380.946190538045;5384.838454846361;5414.377346605033;5421.647592906448;5422.783088676409 06:16:46 INFO - PROCESS | 3551 | |1;ext.html;612.9601575897566;635.9554831161821;643.1927930447289;653.4413076819319;686.0738003695009;37688.81155594225;39384.40923386144;39467.80266098673;39470.802645986805;39524.80237598812;39515.209695806065;40305.59694403055;40474.39288410676;40488;40588.79705601468;8474.40679152458;8673.13268673134;8673.436226645279;8674.04585495595;8686.478811271312;8528.061913189575;8595.828083438328;8602.397832151752;8610.784730381727;8634.740957771246;8610.225079742822;8623.396362254645;8627;8698.608562614698;8720.738377848675;8516.8722469163;8551.615177317035;8553;8591.441556298852;8604.39769216155;8629.741107766777;8766;8767.035626081126;8806.515641639708;8827.735167944971;33190.33619327624;39817.40273895894;40354.79822600898;40373.394399084034;40531.79734101311;2897.1598236511386;3074.308280636861;3271.96728032719;3391.728661707082;3659.323025240339;26868.462630747275;27173.45653086947;27413;31965.200869978205;32750.344993100243;4186.81159347827;4201.495820501529;4224.324108142682;4299.634531064832;4305.052888364555;233770;237183;237969;238857.80571097208;238905;34834.825825871216;35734.28531429357;56513.71743141258;56563.15155272592;56811.71594142003;34432;34566;34604.13489662779;34659.65340346564;34671.65328346684;14771.926140369229;14811.703765924836;14908.18005009735;14948.551543453495;14973.026753261222;12689.555865544662;12779.488820447077;12795.808062878878;12813.103082784302;12886.80669789954;8400.705975290835;8426.873596896052;8477;8502.65989360431;8547.487150770974;3281.8851340202978;3363.1255873473074;3365.209175843675;3382.0530251529613;3399.7620166588595;1089.1831126655009;1106.3748981825242;1106.5076041161606;1116.0625074937093;1183.6922400175845;30994.535081973787;31127.377452450823;31690.207744806103;31723.52414713781;31822.363552728817;1171.3616079236836;1219.615821016377;1235.6416639174718;1239.1759479945736;1261.7539579781856;16917.661646766996;16935.407260745815;17198.484045478657;17219.052952087757;17976.730349044774;439756;442669;445544;446106;447813;55464.44535554673;56320;56460.43539564634;56600.433995659514;56750.14874776881;1316.8288122544009;1356.911800732969;1399.7130588229388;1415.3206460898825;1428.435767871685;30852.22869428282;30930.845345773127;31628;32186;32254.35491290208;48862.11378862085;49660.503394965584;49747.25379119244;49764;49770.75114624404;422102;429044;429955;430165;432977;27358;27643.44713105767;27651.446971060064;27717;27754.722452776023;45311.79545623415;46467;46469.76765116153;46498;46841.29738054;38717;39371.409428858016;39417.21165576615;39746;40218.798906005286;37998.62001379951;38503.5796312257;38538.229235414576;39017.80491097526;39427;35537.82231088828;39755.40366894441;40413;42005.15989680251;42273.365899512144;32602;33271.50092748562;33641.495377569845;33662;33784.49323260104;25582.23253302404;26898.731012690405;27063.458730825667;27365.179044628694;27664.861675691493 06:16:46 INFO - PROCESS | 3551 | |2;jquery.html;376.7494616080305;378.0963497241592;380.2015766889531;382.89661791316337;386.31814846795396;17531.561710957216;18345.633087338247;18912.1489532971;19340.419787406365;19400.126994285274;17968.191431385585;18090.5477363066;18448.81551184491;18699.62600747984;18721.15754791034;5021.874453138665;5159.819406320779;5185.351831021122;5199.792008319662;5203.141481655542;4082.9795851020704;5429.511343979041;5444.265024221739;5451.64564303321;5453.672779633215;5343.118385466393;5363.570914326844;5371.274877891474;5406.756695948672;5412.566994640439;5326.547243484309;5432.429594892519;5459.181122831567;5462.153366228241;5469.671819690831;4611.2852507861;5344.599155063386;5365.651232669864;5376.650517716336;5402.78388864445;12434.689132771662;12445.75108497825;19718.21127154912;22024;22448;2076.4705000224844;2127.5000374911883;2193.616117179487;2220.7335119785566;2228.0419419649543;9039.728808135766;9299.209567186797;9377.859332110023;9978.351407158512;13943.02398832072;1762.7620271263343;1876.1744832273891;1905.7903630600622;1907.4849790556611;1931.6329897319604;75495.62252188759;83280.58359708224;85039.5748021256;85364.57317713434;85476;10015.549300281506;10676.679699609023;11169;11171.944140279247;11218.831717524243;15547.378104875905;15616.76574851378;15627;15639.218039098227;15715.607109822346;7943.285104340637;8106.878396824052;8115.513069215866;8195.754127376189;8223.876641850376;7391.0761154855645;7450.515716478411;7703.768886933401;7765.563370776425;7771.417143714244;4433.578810013044;4479.350494178326;4485.775711214426;4514.119746649438;4719.126961512131;1808.3868809570045;1830.3502256698946;1873.194526353681;2017.7578690557227;2058.7735349111585;987.7876256604865;1050.611273828673;1066.269605320358;1088.8911108889047;1091.6724982505216;16911.408100716417;17127.229274682668;17465.91267043682;17905;18298.988385162982;993.8310487217191;1003.4531180506641;1020.2450186861669;1031.3605564550028;1056.0706578211125;10134.847977280348;10146.239032072624;10698.839517407245;10778.94610526958;10831.891681083245;490965;508233;509283;523455;527194;61748.38251617516;62992;100234.49882750539;102373.48813255886;104550.47724761328;1048.0881632979203;1063.1229235880276;1065.9307145035548;1068;1098.1215027977587;16434.863467749594;16669.99980001204;16826.915865420593;16967.151642418077;17155.142242888054;37366.439503406924;39070.60929390784;39547;39851.60256250256;40197;56484.435155647916;57763.422365775805;57929.710351449656;58505;59221;6987.336203060701;7494.925050749423;7512.248775122444;7849.646765895663;8304.29413499835;8725.127487251224;11814.232074915102;12805.295708736108;12879.806802897776;12961.611151665466;11496.597619083292;11779.705507362385;11847.348395838311;11998;12108.878911210775;11409;11514.481848316678;11630.185886987829;11631.127665425296;11687.415629218674;11451.713707157387;11683.591074312359;12114.575989840314;12159.270443773403;12258.20321679088;7182.209956904632;7457.92542074594;7475.0656167979005;7529.661165247687;7649.158592554703;11396;11402.144839136932;11626.53493860236;11703.76592468163;12124.090693198223 06:16:46 INFO - PROCESS | 3551 | |3;mootools.html;1479.933402996865;1513.8864585156114;1617.6845515124548;1694.9322027118915;1695.4235559909628;7363.226861179566;7652.426068044898;7831.490953088045;7860.803479913005;7864.685412583497;7835.138134805167;7898.328642065431;7959.602019899011;7961.1242763295995;8013.07849597295;2270.9886450567765;2295.5064661097863;2296.59809533331;2302.827287953402;2304.850184737995;2187.9343619691354;2203.55928814237;2218.8779617121054;2231.241377931503;2232.4195709115584;2203.2619072610696;2241.2155745489113;2247.6965609642734;2254.030766770288;2267.036509483463;2184.737831460227;2189.397915573214;2197.2199869046417;2203.1187524989973;2204.526026904215;2234.6312858378346;2235.698180745595;2237.093976939342;2258.446680563256;2261.615525360676;7963.562004089773;8019.67921283148;8113.7565873023905;8121.269085782249;8121.837563248702;4990.3762029746285;5099.4900509949075;5128.615353848439;5144.948550514484;5179.792808287664;3334.983325083359;3340.749443791701;3376.40912840252;3423.9486407703903;3436.1581412553833;1106.9778604427866;1107.534835369147;1121.0919155484085;1139.709374109605;1153.9826902596383;11169.832452513137;11182.440877956069;11190.272632278877;11227.382493962828;11253.943730281379;4320.092780516064;4433.733975961452;4488.371627972087;4492.483364413134;4728.290756386501;8613.09562495929;8650.653973841101;8659;8701.26039286655;8710.085441028728;4857.95142048575;4878.000009997942;4882.316475693406;4891.633127515451;4904.926426103611;4080.510338759368;4513.909721805611;4604.631629469634;4616.8614941551805;4625.398698169217;3766.152615661454;3843.7501562398356;3860.864869729546;3913.7651740895635;3978.3634618461488;1149.7298134938283;1154.7401834587151;1162.3084264862393;1171.1216587559331;1218.7988981818078;880;968.2834702320373;974.444566597047;981.2248323824242;989.1098011789303;5728.856778580569;5775.393583673654;5866.208061911588;5877.39719539972;5978.8206353809455;912.8767616371838;919.852823548229;924.366808736018;1005.2209537608265;1020.4387586827364;4000.6399424051974;4038.51537815464;4068.145689405258;4071.0840060986634;4073.3889916512167;10360.222983276284;10546.894531054591;10597.152227821756;10684;10715.303505272132;10453.163746900229;10593.364398136137;10593.735156620993;10609.045185933148;10626.14990800734;7741.264579864904;7921.801954951057;7992.560409177435;8001.519908805491;8013.479123857047;5583.246261754611;5800.854978625568;5823.79616713413;5863.472287493975;5909.8227053188475;9456.527173641429;9483.478408687588;9533.189678877374;9630.759231019281;9633.373830700983;9597.616095356387;9624.326297159132;9907.752306192402;9920.801583968425;9944.801103977736;6898.275681053417;7066.187388450394;7248.637568121679;7266.564006159648;7299.124105107208;7701.6534255957495;7734.419918506022;7735;7771.37828973692;7806.882896756667;6911.619860907698;7086.858262834611;7174.2108368078425;7191.604461754445;7272.563646181246;7013.333733295329;7020.719171233298;7081.610511421921;7096.574205547684;7122.074130363019;6342.809715708536;6550.705218265094;6557.2131344239;6562.475001999924;6577.408033276836;4961.776720047535;5120.052790233819;5171.431142574389;5184.092783762751;5199.012187684328;5174.275601415729;5199.440167949676;5202.869928251824;5231.529162375405;5292.576593872404 06:16:46 INFO - PROCESS | 3551 | |4;prototype.html;304.08470503783604;307.3346205465169;310.1393632669343;312.1789693107128;319.270466982944;5711.942880571203;5937.139114828347;5964.284285885695;5964.956132676781;6071.908921366183;5947.643141411508;6021.561267686583;6027.487663548603;6029.8191054268445;6036.788712395067;4524.547545245482;4545.568171023748;4545.727256364612;4559.498455169929;4571.748553829538;4442.577955094261;4566.70316429431;4586.816527338902;4594.356790049395;4605.585497305242;4460.524408953046;4486.842960496383;4499.955000449986;4507.706999045052;4515.435570553681;4509.684322097454;4512.345709872066;4521.321801729734;4524.796384162688;4544.840930567414;3875.283072631544;3929.3909444035935;3955.9406608900604;3958.881233562969;3971.5829837867186;5738.225339579145;5786.971065144689;5802.303723553201;5806.361300256968;5823.912641310384;5156.9742151289;5190.143626301693;5195.6622819516615;5213.791448342062;5249.343832020997;6080.2399700037495;6275.686215689243;6285.528585356071;6295.464885484739;6301.464375528086;4325.935110973338;4332.241857674894;4343.131373725268;4350.108227813323;4351.804168812379;6399.168108145957;6550.868982620321;6581.341865813428;6598.373154550358;6630.138082049351;4381.802818873159;4397.560243975641;4398.186335527937;4422.402975598253;4436.6672499562665;4445;4453.77731113443;4486.506484286726;4492.865214043584;4500.032493014018;5217.34783152106;5232.581393488512;5253.317068781111;5262.079136151158;5265.104932161542;6051.425114614105;6068.666223357669;6214.2542894852;6326.430621244018;6411.166548348778;1514.3639671338065;1528.465037236958;1529.6405344743976;1535.5163123616248;1535.7466018106886;990.390909590611;1001.3391161833155;1009.9091081802673;1015.8520871415253;1021.7292417509366;6001.399860014051;6022.728977196037;6029.909551356734;6034.758609655652;6067.54493412987;6424.293327733945;6471.482281417475;6494.967525162344;6499.220093588705;6552.3775241352;5773.422657734193;5961.195238642727;5991.191189189491;6018.668973206428;6019.307779605314;3469.2020835208045;3483.4252348362743;3493.12671832042;3496.7727097738566;3501.5447991761416;6475;6659.134312539436;6809.353111454404;6835.829104272333;6846.7945961621235;6711.765088221987;6721.462283017445;6722.226943901514;6740.460763138937;6753.831154221086;6532.477401807844;6796.524243302922;6816.863662726718;6882.109514004131;6893.931060689329;6437.324080971431;6438.227412710505;6490.026496025634;6596.637184954873;6607.504437167136;6159.5688301818445;6419.550631455753;6432.195975503062;6453.903191452038;6455.580387274812;6775.695093720893;6779.89830152558;6822.488313376616;6828.931710682829;6853.211880633591;4320.783960801885;4328.956710432855;4330.545292744217;4344.565543445757;4359.411479450234;6373.6494492801485;6401.679916004275;6539.574927629689;6581.539292249497;6596.769113081019;6300.59046161998;6334.651594162366;6359.3640635936035;6361.2048493938255;6365.713542890674;6131.509479241561;6248.125262463168;6342.112104305494;6343.238811342669;6364.427201551883;6205.193324867739;6209.906851397323;6257.906131407942;6272;6294.937050629435;6359.586626869239;6370.522210834113;6449.871002579828;6465.903011454926;6474.676266186766;5981.431763982415;6277.027060805583;6327.209098862642;6336.873262534816;6349.8730025400155 06:16:46 INFO - PROCESS | 3551 | |5;yui.html;694.5069001009283;717.9497435179538;725.5356571794051;756.1417790807432;763.5266134996307;12174.939125304372;12249.571265005727;12296.815547766768;12357.814632780515;12485.375731213437;13670.384832682528;14076.366563504642;14159.858401415982;14173.645658858533;14212.573622791333;675.810772983563;813.1340122769246;815.4373482297226;816.5508970066469;817.3297895725508;787.5353541410567;807.2290962131151;807.5598798654718;811.452269717941;811.7727036429809;834.1366685480529;838.7232213369604;841.5876220651897;842.2335674536173;843.1105184030845;831.4263158420671;838.3586556284478;838.8532006898769;839.4501601451029;841.5539763925068;605.530713696884;608.5527137553938;608.7504123309421;613.0314103716117;613.8066509049635;12730.681732956658;12810.29543375114;12823.61529154127;12874.227546347156;12879.356032198353;12850.293233872133;12876.871231287661;13102.47590096395;13224.206547607175;13461.932690336485;10423.530941107592;10500.21248406365;10592.205584581186;10632.946835265775;10641.840372394421;3790.90522736931;3864.8260828262796;3884.8251828667776;3900.921981560353;3936.645701886844;57678;59408.40591594072;59447.40552594462;59902.70048649773;59913;10308.896911030944;10628;10647.520861561248;10769.138468922467;10776.353418794897;17785.28858845632;17841.643167136586;17886.821131788776;17940.102994850204;18000.729989050174;7741.032370953631;7799.259070388304;7824.530528168328;7946.602669866484;8204.8359032819;4436.933445998313;4454.04238088806;4517.412736344254;4561.817527298937;4672.112298663243;3108.797928134664;3196.7122958933805;3199.5360672702327;3205.3268813549416;3219.4526930421885;575.5654480866918;587.6289173186174;601.2994860986902;602.2923065398139;606.4481321996961;587.3157771196509;694.0976730250654;700.656678227675;702.4871843554234;714.4891402647132;8542.572871356408;8657.177568131017;8826.602802873886;8895.73312800617;9163.81672366549;589.8201048680108;601.666075328197;656;668.488606216245;670.8155257304182;4481;4490.753008584494;4528.6377089833395;4665.743384113906;4672.2057250267535;61647.383526164165;64426.35573644297;64485;64879.675601622635;65224;56057.71971140118;57708.42291577031;58019.709901450224;58355;59292;41151.794241028605;41836.372454413206;46517.30224046642;48715.26927096096;49470;8722.738317850475;8828.867566986371;9009.324300677345;9150.954245228731;9288;30740.538891916192;30954;31562.684373155975;31863.203419914687;32184.19539511531;44891.85756996979;46223.30665040094;46925.3576124834;48537.02925941391;49454.50545494499;12168.695782605151;12215.450304736485;12222.388880556115;12304.323262220663;12459.688507787016;12549.498020079094;12857.292848893401;13174.275414852274;13532.86467135316;13573.660658483617;12324.938375308066;12539.811902821282;12565.183263088236;12603.24380537134;12683.23900565969;12500.437480313225;12735.681607959876;12738.68153296138;12762.744745104861;12865;12205.20666156697;12296.877031229573;12429.875701243234;12649.177803442746;12748.872511274769;10443.94778026105;10609.787804244026;10705.625303114353;10708;10918.12654987615;10217.795644086927;10389;10394.750650921236;10401.323913945569;10467.371957682564 06:16:46 INFO - PROCESS | 3551 | __end_tp_report 06:16:46 INFO - PROCESS | 3551 | __start_cc_report 06:16:46 INFO - PROCESS | 3551 | _x_x_mozilla_cycle_collect,340 06:16:46 INFO - PROCESS | 3551 | __end_cc_report 06:16:46 INFO - PROCESS | 3551 | __startTimestamp1460899006222__endTimestamp 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - PROCESS | 3551 | ------- Summary: start ------- 06:16:46 INFO - PROCESS | 3551 | Number of tests: 6 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - PROCESS | 3551 | [#0] dojo.html Cycles:165 Average:5274.95 Median:5485.18 stddev:591.65 (10.8%) stddev-sans-first:566.11 06:16:46 INFO - PROCESS | 3551 | Values: 3008.1 3052.3 3061.4 3078.6 3091.1 5317.1 5336.1 5346.5 5361.1 5363.1 5231.6 5341.6 5366.9 5400.1 5485.2 4869.1 4915.3 4924.3 5047.2 5069.1 4977.9 4994.8 4996.1 4997.8 5010.6 4739.8 4829.4 4839.3 4904.2 4971.1 4887.2 4891.0 4909.4 4914.6 4931.5 4850.5 4883.4 4886.4 4888.4 4937.0 5264.6 5286.0 5316.7 5321.2 5334.0 5670.5 5677.2 5702.0 5737.9 5744.6 5571.5 5695.0 5738.7 5777.3 5792.3 5308.5 5316.5 5339.0 5362.3 5381.1 5757.3 5762.2 5766.2 5790.9 5801.5 5527.1 5571.4 5579.1 5592.5 5644.4 5746.5 5750.9 5752.5 5757.0 5778.0 5566.7 5614.6 5657.3 5660.9 5699.9 5482.6 5553.6 5577.6 5577.7 5597.5 4279.7 4284.1 4289.2 4310.2 4319.0 3839.5 3840.8 3849.0 3867.2 3880.4 5208.2 5218.3 5244.1 5272.6 5281.8 5586.7 5587.5 5595.5 5606.3 5626.3 5231.1 5248.4 5250.1 5252.0 5291.4 4787.2 4823.5 4856.7 4877.4 4886.4 5887.4 5899.4 5906.6 5930.8 5932.9 5693.3 5701.8 5702.4 5704.8 5712.2 5741.9 5820.9 5859.4 5904.7 5905.0 5539.8 5553.9 5564.0 5570.3 5574.1 5590.2 5595.4 5613.4 5616.5 5624.1 5352.7 5489.4 5531.3 5550.8 5576.2 5536.8 5537.6 5581.2 5596.2 5638.5 5403.4 5489.6 5519.6 5519.7 5525.9 5515.9 5596.9 5621.6 5627.7 5686.6 5380.9 5384.8 5414.4 5421.6 5422.8 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - PROCESS | 3551 | [#1] ext.html Cycles:180 Average:52053.12 Median:39377.91 stddev:101324.21 (257.3%) stddev-sans-first:101534.84 06:16:46 INFO - PROCESS | 3551 | Values: 613.0 636.0 643.2 653.4 686.1 37688.8 39384.4 39467.8 39470.8 39524.8 39515.2 40305.6 40474.4 40488.0 40588.8 8474.4 8673.1 8673.4 8674.0 8686.5 8528.1 8595.8 8602.4 8610.8 8634.7 8610.2 8623.4 8627.0 8698.6 8720.7 8516.9 8551.6 8553.0 8591.4 8604.4 8629.7 8766.0 8767.0 8806.5 8827.7 33190.3 39817.4 40354.8 40373.4 40531.8 2897.2 3074.3 3272.0 3391.7 3659.3 26868.5 27173.5 27413.0 31965.2 32750.3 4186.8 4201.5 4224.3 4299.6 4305.1 233770.0 237183.0 237969.0 238857.8 238905.0 34834.8 35734.3 56513.7 56563.2 56811.7 34432.0 34566.0 34604.1 34659.7 34671.7 14771.9 14811.7 14908.2 14948.6 14973.0 12689.6 12779.5 12795.8 12813.1 12886.8 8400.7 8426.9 8477.0 8502.7 8547.5 3281.9 3363.1 3365.2 3382.1 3399.8 1089.2 1106.4 1106.5 1116.1 1183.7 30994.5 31127.4 31690.2 31723.5 31822.4 1171.4 1219.6 1235.6 1239.2 1261.8 16917.7 16935.4 17198.5 17219.1 17976.7 439756.0 442669.0 445544.0 446106.0 447813.0 55464.4 56320.0 56460.4 56600.4 56750.1 1316.8 1356.9 1399.7 1415.3 1428.4 30852.2 30930.8 31628.0 32186.0 32254.4 48862.1 49660.5 49747.3 49764.0 49770.8 422102.0 429044.0 429955.0 430165.0 432977.0 27358.0 27643.4 27651.4 27717.0 27754.7 45311.8 46467.0 46469.8 46498.0 46841.3 38717.0 39371.4 39417.2 39746.0 40218.8 37998.6 38503.6 38538.2 39017.8 39427.0 35537.8 39755.4 40413.0 42005.2 42273.4 32602.0 33271.5 33641.5 33662.0 33784.5 25582.2 26898.7 27063.5 27365.2 27664.9 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - PROCESS | 3551 | [#2] jquery.html Cycles:180 Average:29026.26 Median:2160.56 stddev:84355.75 (3904.4%) stddev-sans-first:84564.96 06:16:46 INFO - PROCESS | 3551 | Values: 376.7 378.1 380.2 382.9 386.3 17531.6 18345.6 18912.1 19340.4 19400.1 17968.2 18090.5 18448.8 18699.6 18721.2 5021.9 5159.8 5185.4 5199.8 5203.1 4083.0 5429.5 5444.3 5451.6 5453.7 5343.1 5363.6 5371.3 5406.8 5412.6 5326.5 5432.4 5459.2 5462.2 5469.7 4611.3 5344.6 5365.7 5376.7 5402.8 12434.7 12445.8 19718.2 22024.0 22448.0 2076.5 2127.5 2193.6 2220.7 2228.0 9039.7 9299.2 9377.9 9978.4 13943.0 1762.8 1876.2 1905.8 1907.5 1931.6 75495.6 83280.6 85039.6 85364.6 85476.0 10015.5 10676.7 11169.0 11171.9 11218.8 15547.4 15616.8 15627.0 15639.2 15715.6 7943.3 8106.9 8115.5 8195.8 8223.9 7391.1 7450.5 7703.8 7765.6 7771.4 4433.6 4479.4 4485.8 4514.1 4719.1 1808.4 1830.4 1873.2 2017.8 2058.8 987.8 1050.6 1066.3 1088.9 1091.7 16911.4 17127.2 17465.9 17905.0 18299.0 993.8 1003.5 1020.2 1031.4 1056.1 10134.8 10146.2 10698.8 10778.9 10831.9 490965.0 508233.0 509283.0 523455.0 527194.0 61748.4 62992.0 100234.5 102373.5 104550.5 1048.1 1063.1 1065.9 1068.0 1098.1 16434.9 16670.0 16826.9 16967.2 17155.1 37366.4 39070.6 39547.0 39851.6 40197.0 56484.4 57763.4 57929.7 58505.0 59221.0 6987.3 7494.9 7512.2 7849.6 8304.3 8725.1 11814.2 12805.3 12879.8 12961.6 11496.6 11779.7 11847.3 11998.0 12108.9 11409.0 11514.5 11630.2 11631.1 11687.4 11451.7 11683.6 12114.6 12159.3 12258.2 7182.2 7457.9 7475.1 7529.7 7649.2 11396.0 11402.1 11626.5 11703.8 12124.1 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - PROCESS | 3551 | [#3] mootools.html Cycles:180 Average:5469.85 Median:5124.33 stddev:3019.03 (58.9%) stddev-sans-first:3012.61 06:16:46 INFO - PROCESS | 3551 | Values: 1479.9 1513.9 1617.7 1694.9 1695.4 7363.2 7652.4 7831.5 7860.8 7864.7 7835.1 7898.3 7959.6 7961.1 8013.1 2271.0 2295.5 2296.6 2302.8 2304.9 2187.9 2203.6 2218.9 2231.2 2232.4 2203.3 2241.2 2247.7 2254.0 2267.0 2184.7 2189.4 2197.2 2203.1 2204.5 2234.6 2235.7 2237.1 2258.4 2261.6 7963.6 8019.7 8113.8 8121.3 8121.8 4990.4 5099.5 5128.6 5144.9 5179.8 3335.0 3340.7 3376.4 3423.9 3436.2 1107.0 1107.5 1121.1 1139.7 1154.0 11169.8 11182.4 11190.3 11227.4 11253.9 4320.1 4433.7 4488.4 4492.5 4728.3 8613.1 8650.7 8659.0 8701.3 8710.1 4858.0 4878.0 4882.3 4891.6 4904.9 4080.5 4513.9 4604.6 4616.9 4625.4 3766.2 3843.8 3860.9 3913.8 3978.4 1149.7 1154.7 1162.3 1171.1 1218.8 880.0 968.3 974.4 981.2 989.1 5728.9 5775.4 5866.2 5877.4 5978.8 912.9 919.9 924.4 1005.2 1020.4 4000.6 4038.5 4068.1 4071.1 4073.4 10360.2 10546.9 10597.2 10684.0 10715.3 10453.2 10593.4 10593.7 10609.0 10626.1 7741.3 7921.8 7992.6 8001.5 8013.5 5583.2 5800.9 5823.8 5863.5 5909.8 9456.5 9483.5 9533.2 9630.8 9633.4 9597.6 9624.3 9907.8 9920.8 9944.8 6898.3 7066.2 7248.6 7266.6 7299.1 7701.7 7734.4 7735.0 7771.4 7806.9 6911.6 7086.9 7174.2 7191.6 7272.6 7013.3 7020.7 7081.6 7096.6 7122.1 6342.8 6550.7 6557.2 6562.5 6577.4 4961.8 5120.1 5171.4 5184.1 5199.0 5174.3 5199.4 5202.9 5231.5 5292.6 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - PROCESS | 3551 | [#4] prototype.html Cycles:180 Average:5267.59 Median:6020.43 stddev:1612.74 (26.8%) stddev-sans-first:1573.64 06:16:46 INFO - PROCESS | 3551 | Values: 304.1 307.3 310.1 312.2 319.3 5711.9 5937.1 5964.3 5965.0 6071.9 5947.6 6021.6 6027.5 6029.8 6036.8 4524.5 4545.6 4545.7 4559.5 4571.7 4442.6 4566.7 4586.8 4594.4 4605.6 4460.5 4486.8 4500.0 4507.7 4515.4 4509.7 4512.3 4521.3 4524.8 4544.8 3875.3 3929.4 3955.9 3958.9 3971.6 5738.2 5787.0 5802.3 5806.4 5823.9 5157.0 5190.1 5195.7 5213.8 5249.3 6080.2 6275.7 6285.5 6295.5 6301.5 4325.9 4332.2 4343.1 4350.1 4351.8 6399.2 6550.9 6581.3 6598.4 6630.1 4381.8 4397.6 4398.2 4422.4 4436.7 4445.0 4453.8 4486.5 4492.9 4500.0 5217.3 5232.6 5253.3 5262.1 5265.1 6051.4 6068.7 6214.3 6326.4 6411.2 1514.4 1528.5 1529.6 1535.5 1535.7 990.4 1001.3 1009.9 1015.9 1021.7 6001.4 6022.7 6029.9 6034.8 6067.5 6424.3 6471.5 6495.0 6499.2 6552.4 5773.4 5961.2 5991.2 6018.7 6019.3 3469.2 3483.4 3493.1 3496.8 3501.5 6475.0 6659.1 6809.4 6835.8 6846.8 6711.8 6721.5 6722.2 6740.5 6753.8 6532.5 6796.5 6816.9 6882.1 6893.9 6437.3 6438.2 6490.0 6596.6 6607.5 6159.6 6419.6 6432.2 6453.9 6455.6 6775.7 6779.9 6822.5 6828.9 6853.2 4320.8 4329.0 4330.5 4344.6 4359.4 6373.6 6401.7 6539.6 6581.5 6596.8 6300.6 6334.7 6359.4 6361.2 6365.7 6131.5 6248.1 6342.1 6343.2 6364.4 6205.2 6209.9 6257.9 6272.0 6294.9 6359.6 6370.5 6449.9 6465.9 6474.7 5981.4 6277.0 6327.2 6336.9 6349.9 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - PROCESS | 3551 | [#5] yui.html Cycles:180 Average:14707.29 Median:24691.31 stddev:17562.65 (71.1%) stddev-sans-first:17580.39 06:16:46 INFO - PROCESS | 3551 | Values: 694.5 717.9 725.5 756.1 763.5 12174.9 12249.6 12296.8 12357.8 12485.4 13670.4 14076.4 14159.9 14173.6 14212.6 675.8 813.1 815.4 816.6 817.3 787.5 807.2 807.6 811.5 811.8 834.1 838.7 841.6 842.2 843.1 831.4 838.4 838.9 839.5 841.6 605.5 608.6 608.8 613.0 613.8 12730.7 12810.3 12823.6 12874.2 12879.4 12850.3 12876.9 13102.5 13224.2 13461.9 10423.5 10500.2 10592.2 10632.9 10641.8 3790.9 3864.8 3884.8 3900.9 3936.6 57678.0 59408.4 59447.4 59902.7 59913.0 10308.9 10628.0 10647.5 10769.1 10776.4 17785.3 17841.6 17886.8 17940.1 18000.7 7741.0 7799.3 7824.5 7946.6 8204.8 4436.9 4454.0 4517.4 4561.8 4672.1 3108.8 3196.7 3199.5 3205.3 3219.5 575.6 587.6 601.3 602.3 606.4 587.3 694.1 700.7 702.5 714.5 8542.6 8657.2 8826.6 8895.7 9163.8 589.8 601.7 656.0 668.5 670.8 4481.0 4490.8 4528.6 4665.7 4672.2 61647.4 64426.4 64485.0 64879.7 65224.0 56057.7 57708.4 58019.7 58355.0 59292.0 41151.8 41836.4 46517.3 48715.3 49470.0 8722.7 8828.9 9009.3 9151.0 9288.0 30740.5 30954.0 31562.7 31863.2 32184.2 44891.9 46223.3 46925.4 48537.0 49454.5 12168.7 12215.5 12222.4 12304.3 12459.7 12549.5 12857.3 13174.3 13532.9 13573.7 12324.9 12539.8 12565.2 12603.2 12683.2 12500.4 12735.7 12738.7 12762.7 12865.0 12205.2 12296.9 12429.9 12649.2 12748.9 10443.9 10609.8 10705.6 10708.0 10918.1 10217.8 10389.0 10394.8 10401.3 10467.4 06:16:46 INFO - PROCESS | 3551 | -------- Summary: end -------- 06:16:46 INFO - PROCESS | 3551 | 06:16:46 INFO - TEST-INFO | 3551: exit 0 06:16:46 INFO - TEST-OK | dromaeo_css | took 1111549ms 06:16:46 INFO - TEST-START | kraken 06:16:46 INFO - operating with platform_type : linux_ 06:16:46 INFO - Initialising browser for kraken test... 06:16:46 INFO - TEST-INFO | started process 3781 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmppDHYM5/profile http://localhost:48693/getInfo.html) 06:16:50 INFO - PROCESS | 3781 | 06:16:50 INFO - PROCESS | 3781 | (process:3850): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 06:16:50 INFO - PROCESS | 3781 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 06:16:51 INFO - PROCESS | 3781 | __metrics Screen width/height:1600/1200 06:16:51 INFO - PROCESS | 3781 | colorDepth:24 06:16:51 INFO - PROCESS | 3781 | Browser inner width/height: 1024/697 06:16:51 INFO - PROCESS | 3781 | __metrics 06:16:51 ERROR - PROCESS | 3781 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 06:16:52 INFO - TEST-INFO | 3781: exit 0 06:16:52 INFO - Browser initialized. 06:16:52 INFO - Running cycle 1/1 for kraken test... 06:16:52 INFO - TEST-INFO | started process 3901 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmppDHYM5/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:16:54 INFO - PROCESS | 3901 | 06:16:54 INFO - PROCESS | 3901 | (process:3962): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 06:17:04 INFO - PROCESS | 3901 | RSS: Main: 163581952 06:17:04 INFO - PROCESS | 3901 | 06:17:06 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:48693/tests/kraken/driver.html?testName=audio-beat-detection) 06:17:07 INFO - PROCESS | 3901 | RSS: Main: 167944192 06:17:07 INFO - PROCESS | 3901 | 06:17:10 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:48693/tests/kraken/driver.html?testName=audio-dft) 06:17:11 INFO - PROCESS | 3901 | RSS: Main: 171143168 06:17:11 INFO - PROCESS | 3901 | 06:17:13 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:48693/tests/kraken/driver.html?testName=audio-fft) 06:17:14 INFO - PROCESS | 3901 | RSS: Main: 162070528 06:17:14 INFO - PROCESS | 3901 | 06:17:16 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:48693/tests/kraken/driver.html?testName=audio-oscillator) 06:17:17 INFO - PROCESS | 3901 | RSS: Main: 162447360 06:17:17 INFO - PROCESS | 3901 | 06:17:19 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:48693/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:17:20 INFO - PROCESS | 3901 | RSS: Main: 163135488 06:17:20 INFO - PROCESS | 3901 | 06:17:23 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:48693/tests/kraken/driver.html?testName=imaging-darkroom) 06:17:23 INFO - PROCESS | 3901 | RSS: Main: 163110912 06:17:23 INFO - PROCESS | 3901 | 06:17:27 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:48693/tests/kraken/driver.html?testName=imaging-desaturate) 06:17:27 INFO - PROCESS | 3901 | RSS: Main: 165445632 06:17:27 INFO - PROCESS | 3901 | 06:17:30 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:48693/tests/kraken/driver.html?testName=json-parse-financial) 06:17:31 INFO - PROCESS | 3901 | RSS: Main: 165646336 06:17:31 INFO - PROCESS | 3901 | 06:17:33 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:48693/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:17:33 INFO - PROCESS | 3901 | RSS: Main: 166047744 06:17:33 INFO - PROCESS | 3901 | 06:17:35 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:48693/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:17:36 INFO - PROCESS | 3901 | RSS: Main: 166051840 06:17:36 INFO - PROCESS | 3901 | 06:17:38 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:48693/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:17:38 INFO - PROCESS | 3901 | RSS: Main: 166473728 06:17:38 INFO - PROCESS | 3901 | 06:17:41 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:48693/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:17:41 INFO - PROCESS | 3901 | RSS: Main: 166830080 06:17:41 INFO - PROCESS | 3901 | 06:17:44 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:48693/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:17:45 INFO - PROCESS | 3901 | RSS: Main: 166633472 06:17:45 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | Cycle 1(1): loaded http://localhost:48693/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:48693/tests/kraken/driver.html?testName=ai-astar) 06:17:47 INFO - PROCESS | 3901 | RSS: Main: 168194048 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | __start_tp_report 06:17:47 INFO - PROCESS | 3901 | _x_x_mozilla_page_load 06:17:47 INFO - PROCESS | 3901 | _x_x_mozilla_page_load_details 06:17:47 INFO - PROCESS | 3901 | |i|pagename|runs| 06:17:47 INFO - PROCESS | 3901 | |0;ai-astar;114;106;112;113;112;124;113;113;111;110 06:17:47 INFO - PROCESS | 3901 | |1;audio-beat-detection;151;128;162;182;130;155;156;134;185;130 06:17:47 INFO - PROCESS | 3901 | |2;audio-dft;163;162;162;164;161;162;173;162;165;163 06:17:47 INFO - PROCESS | 3901 | |3;audio-fft;73;77;78;145;78;74;78;73;157;73 06:17:47 INFO - PROCESS | 3901 | |4;audio-oscillator;92;93;152;93;92;92;154;93;92;151 06:17:47 INFO - PROCESS | 3901 | |5;imaging-gaussian-blur;117;117;117;117;118;117;118;117;118;118 06:17:47 INFO - PROCESS | 3901 | |6;imaging-darkroom;147;148;147;150;147;148;147;147;147;147 06:17:47 INFO - PROCESS | 3901 | |7;imaging-desaturate;96;95;94;96;95;94;96;95;95;95 06:17:47 INFO - PROCESS | 3901 | |8;json-parse-financial;57;58;58;58;60;64;57;82;56;64 06:17:47 INFO - PROCESS | 3901 | |9;json-stringify-tinderbox;62;63;65;64;64;62;62;68;62;62 06:17:47 INFO - PROCESS | 3901 | |10;stanford-crypto-aes;77;77;77;80;87;78;79;78;79;81 06:17:47 INFO - PROCESS | 3901 | |11;stanford-crypto-ccm;126;128;135;126;128;129;124;127;158;146 06:17:47 INFO - PROCESS | 3901 | |12;stanford-crypto-pbkdf2;172;178;174;167;177;170;175;169;166;167 06:17:47 INFO - PROCESS | 3901 | |13;stanford-crypto-sha256-iterative;69;71;71;70;73;68;68;69;69;68 06:17:47 INFO - PROCESS | 3901 | __end_tp_report 06:17:47 INFO - PROCESS | 3901 | __start_cc_report 06:17:47 INFO - PROCESS | 3901 | _x_x_mozilla_cycle_collect,823 06:17:47 INFO - PROCESS | 3901 | __end_cc_report 06:17:47 INFO - PROCESS | 3901 | __startTimestamp1460899067833__endTimestamp 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | ------- Summary: start ------- 06:17:47 INFO - PROCESS | 3901 | Number of tests: 14 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#0] ai-astar Cycles:10 Average:112.80 Median:113.00 stddev:4.54 (4.0%) stddev-sans-first:4.80 06:17:47 INFO - PROCESS | 3901 | Values: 114.0 106.0 112.0 113.0 112.0 124.0 113.0 113.0 111.0 110.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#1] audio-beat-detection Cycles:10 Average:151.30 Median:155.50 stddev:21.02 (13.5%) stddev-sans-first:22.30 06:17:47 INFO - PROCESS | 3901 | Values: 151.0 128.0 162.0 182.0 130.0 155.0 156.0 134.0 185.0 130.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#2] audio-dft Cycles:10 Average:163.70 Median:163.00 stddev:3.47 (2.1%) stddev-sans-first:3.67 06:17:47 INFO - PROCESS | 3901 | Values: 163.0 162.0 162.0 164.0 161.0 162.0 173.0 162.0 165.0 163.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#3] audio-fft Cycles:10 Average:90.60 Median:75.50 stddev:32.03 (42.4%) stddev-sans-first:33.34 06:17:47 INFO - PROCESS | 3901 | Values: 73.0 77.0 78.0 145.0 78.0 74.0 78.0 73.0 157.0 73.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#4] audio-oscillator Cycles:10 Average:110.40 Median:92.00 stddev:28.95 (31.5%) stddev-sans-first:29.93 06:17:47 INFO - PROCESS | 3901 | Values: 92.0 93.0 152.0 93.0 92.0 92.0 154.0 93.0 92.0 151.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#5] imaging-gaussian-blur Cycles:10 Average:117.40 Median:117.50 stddev:0.52 (0.4%) stddev-sans-first:0.53 06:17:47 INFO - PROCESS | 3901 | Values: 117.0 117.0 117.0 117.0 118.0 117.0 118.0 117.0 118.0 118.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#6] imaging-darkroom Cycles:10 Average:147.50 Median:147.00 stddev:0.97 (0.7%) stddev-sans-first:1.01 06:17:47 INFO - PROCESS | 3901 | Values: 147.0 148.0 147.0 150.0 147.0 148.0 147.0 147.0 147.0 147.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.74 (0.8%) stddev-sans-first:0.71 06:17:47 INFO - PROCESS | 3901 | Values: 96.0 95.0 94.0 96.0 95.0 94.0 96.0 95.0 95.0 95.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#8] json-parse-financial Cycles:10 Average:61.40 Median:59.00 stddev:7.76 (13.2%) stddev-sans-first:8.07 06:17:47 INFO - PROCESS | 3901 | Values: 57.0 58.0 58.0 58.0 60.0 64.0 57.0 82.0 56.0 64.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#9] json-stringify-tinderbox Cycles:10 Average:63.40 Median:63.50 stddev:1.96 (3.1%) stddev-sans-first:2.01 06:17:47 INFO - PROCESS | 3901 | Values: 62.0 63.0 65.0 64.0 64.0 62.0 62.0 68.0 62.0 62.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#10] stanford-crypto-aes Cycles:10 Average:79.30 Median:79.00 stddev:3.02 (3.8%) stddev-sans-first:3.09 06:17:47 INFO - PROCESS | 3901 | Values: 77.0 77.0 77.0 80.0 87.0 78.0 79.0 78.0 79.0 81.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#11] stanford-crypto-ccm Cycles:10 Average:132.70 Median:128.50 stddev:10.94 (8.5%) stddev-sans-first:11.34 06:17:47 INFO - PROCESS | 3901 | Values: 126.0 128.0 135.0 126.0 128.0 129.0 124.0 127.0 158.0 146.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.50 Median:173.00 stddev:4.35 (2.5%) stddev-sans-first:4.61 06:17:47 INFO - PROCESS | 3901 | Values: 172.0 178.0 174.0 167.0 177.0 170.0 175.0 169.0 166.0 167.0 06:17:47 INFO - PROCESS | 3901 | 06:17:47 INFO - PROCESS | 3901 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.60 Median:69.50 stddev:1.65 (2.4%) stddev-sans-first:1.73 06:17:47 INFO - PROCESS | 3901 | Values: 69.0 71.0 71.0 70.0 73.0 68.0 68.0 69.0 69.0 68.0 06:17:47 INFO - PROCESS | 3901 | -------- Summary: end -------- 06:17:47 INFO - PROCESS | 3901 | 06:17:48 INFO - TEST-INFO | 3901: exit 0 06:17:48 INFO - TEST-OK | kraken | took 61911ms 06:17:48 INFO - SUITE-END | took 1173s 06:17:48 INFO - Completed test suite (00:19:33) 06:17:48 INFO - javascript benchmark 06:17:49 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3008.0524634740054, 3052.3284877326982, 3061.433634777566, 3078.6151731033606, 3091.134482344944, 5317.122674758665, 5336.119540275849, 5346.518813306801, 5361.088614935461, 5363.061464243757, 5231.633785635007, 5341.626086173969, 5366.865828354293, 5400.108982017962, 5485.177223416489, 4869.074875773601, 4915.336429582015, 4924.335214746017, 5047.242913562976, 5069.087564238435, 4977.850664480054, 4994.800207991676, 4996.125678006352, 4997.750112494379, 5010.624203184758, 4739.786709598059, 4829.396325459317, 4839.3466881970835, 4904.215325547895, 4971.05549945511, 4887.242477416006, 4890.951090489085, 4909.386326709161, 4914.557689807899, 4931.4821943696115, 4850.466448690641, 4883.438404583483, 4886.364772579542, 4888.388951381077, 4937.0, 5264.552513036397, 5286.04851126797, 5316.73416329182, 5321.201819727034, 5334.03987282289, 5670.461306175948, 5677.176809362661, 5701.971490142523, 5737.8565535861935, 5744.597878148531, 5571.470710282517, 5694.9715251423895, 5738.741756620962, 5777.277840269966, 5792.304923409218, 5308.522232999048, 5316.4683531646915, 5338.973305133488, 5362.302900622894, 5381.112116500773, 5757.337906140764, 5762.193292938992, 5766.163906233573, 5790.913136302959, 5801.50687191585, 5527.115661494142, 5571.359293681197, 5579.088338872064, 5592.524635406036, 5644.379118296984, 5746.482816546531, 5750.88498230033, 5752.453516915886, 5757.0, 5778.046622307273, 5566.721663916788, 5614.606977511617, 5657.32112146545, 5660.943390566042, 5699.857503562361, 5482.616216864861, 5553.6390134641115, 5577.609567330248, 5577.721113944368, 5597.524210442158, 4279.7218180818145, 4284.10033892886, 4289.1850548395705, 4310.181065597527, 4319.0, 3839.462475253467, 3840.8271627776817, 3848.9615103848605, 3867.16855875988, 3880.4373365861793, 5208.218767184952, 5218.269442278084, 5244.134717771525, 5272.551833094153, 5281.841544753664, 5586.720663966867, 5587.497125258747, 5595.496405323541, 5606.271184746039, 5626.2967129108865, 5231.058409486329, 5248.396434410091, 5250.1337279349245, 5252.0, 5291.417944026154, 4787.16224660683, 4823.541763532458, 4856.660033797671, 4877.414710234723, 4886.438059623118, 5887.411258874164, 5899.380565040695, 5906.586538942319, 5930.792422265286, 5932.911006334908, 5693.288338957547, 5701.800436984686, 5702.401247868914, 5704.80033198836, 5712.200291959212, 5741.8564535886935, 5820.912686309624, 5859.44335288147, 5904.704764761831, 5904.9704751475965, 5539.833804985857, 5553.944460555343, 5564.02629539837, 5570.275864137636, 5574.108142697149, 5590.245316882331, 5595.412481689364, 5613.354464236665, 5616.522595579421, 5624.100143977108, 5352.732363381738, 5489.3687225969525, 5531.308586426697, 5550.8057217997175, 5576.219329293983, 5536.75084621201, 5537.612367134423, 5581.162825576196, 5596.160575913483, 5638.464345887134, 5403.378611459732, 5489.64317319373, 5519.586031047607, 5519.724013799374, 5525.889482210253, 5515.862103447446, 5596.916046259228, 5621.55027597783, 5627.718614069198, 5686.57350698691, 5380.946190538045, 5384.838454846361, 5414.377346605033, 5421.647592906448, 5422.783088676409], "value": 5235.0348779891565, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [612.9601575897566, 635.9554831161821, 643.1927930447289, 653.4413076819319, 686.0738003695009, 37688.81155594225, 39384.40923386144, 39467.80266098673, 39470.802645986805, 39524.80237598812, 39515.209695806065, 40305.59694403055, 40474.39288410676, 40488.0, 40588.79705601468, 8474.40679152458, 8673.13268673134, 8673.436226645279, 8674.04585495595, 8686.478811271312, 8528.061913189575, 8595.828083438328, 8602.397832151752, 8610.784730381727, 8634.740957771246, 8610.225079742822, 8623.396362254645, 8627.0, 8698.608562614698, 8720.738377848675, 8516.8722469163, 8551.615177317035, 8553.0, 8591.441556298852, 8604.39769216155, 8629.741107766777, 8766.0, 8767.035626081126, 8806.515641639708, 8827.735167944971, 33190.33619327624, 39817.40273895894, 40354.79822600898, 40373.394399084034, 40531.79734101311, 2897.1598236511386, 3074.308280636861, 3271.96728032719, 3391.728661707082, 3659.323025240339, 26868.462630747275, 27173.45653086947, 27413.0, 31965.200869978205, 32750.344993100243, 4186.81159347827, 4201.495820501529, 4224.324108142682, 4299.634531064832, 4305.052888364555, 233770.0, 237183.0, 237969.0, 238857.80571097208, 238905.0, 34834.825825871216, 35734.28531429357, 56513.71743141258, 56563.15155272592, 56811.71594142003, 34432.0, 34566.0, 34604.13489662779, 34659.65340346564, 34671.65328346684, 14771.926140369229, 14811.703765924836, 14908.18005009735, 14948.551543453495, 14973.026753261222, 12689.555865544662, 12779.488820447077, 12795.808062878878, 12813.103082784302, 12886.80669789954, 8400.705975290835, 8426.873596896052, 8477.0, 8502.65989360431, 8547.487150770974, 3281.8851340202978, 3363.1255873473074, 3365.209175843675, 3382.0530251529613, 3399.7620166588595, 1089.1831126655009, 1106.3748981825242, 1106.5076041161606, 1116.0625074937093, 1183.6922400175845, 30994.535081973787, 31127.377452450823, 31690.207744806103, 31723.52414713781, 31822.363552728817, 1171.3616079236836, 1219.615821016377, 1235.6416639174718, 1239.1759479945736, 1261.7539579781856, 16917.661646766996, 16935.407260745815, 17198.484045478657, 17219.052952087757, 17976.730349044774, 439756.0, 442669.0, 445544.0, 446106.0, 447813.0, 55464.44535554673, 56320.0, 56460.43539564634, 56600.433995659514, 56750.14874776881, 1316.8288122544009, 1356.911800732969, 1399.7130588229388, 1415.3206460898825, 1428.435767871685, 30852.22869428282, 30930.845345773127, 31628.0, 32186.0, 32254.35491290208, 48862.11378862085, 49660.503394965584, 49747.25379119244, 49764.0, 49770.75114624404, 422102.0, 429044.0, 429955.0, 430165.0, 432977.0, 27358.0, 27643.44713105767, 27651.446971060064, 27717.0, 27754.722452776023, 45311.79545623415, 46467.0, 46469.76765116153, 46498.0, 46841.29738054, 38717.0, 39371.409428858016, 39417.21165576615, 39746.0, 40218.798906005286, 37998.62001379951, 38503.5796312257, 38538.229235414576, 39017.80491097526, 39427.0, 35537.82231088828, 39755.40366894441, 40413.0, 42005.15989680251, 42273.365899512144, 32602.0, 33271.50092748562, 33641.495377569845, 33662.0, 33784.49323260104, 25582.23253302404, 26898.731012690405, 27063.458730825667, 27365.179044628694, 27664.861675691493], "value": 18132.06411427528, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [376.7494616080305, 378.0963497241592, 380.2015766889531, 382.89661791316337, 386.31814846795396, 17531.561710957216, 18345.633087338247, 18912.1489532971, 19340.419787406365, 19400.126994285274, 17968.191431385585, 18090.5477363066, 18448.81551184491, 18699.62600747984, 18721.15754791034, 5021.874453138665, 5159.819406320779, 5185.351831021122, 5199.792008319662, 5203.141481655542, 4082.9795851020704, 5429.511343979041, 5444.265024221739, 5451.64564303321, 5453.672779633215, 5343.118385466393, 5363.570914326844, 5371.274877891474, 5406.756695948672, 5412.566994640439, 5326.547243484309, 5432.429594892519, 5459.181122831567, 5462.153366228241, 5469.671819690831, 4611.2852507861, 5344.599155063386, 5365.651232669864, 5376.650517716336, 5402.78388864445, 12434.689132771662, 12445.75108497825, 19718.21127154912, 22024.0, 22448.0, 2076.4705000224844, 2127.5000374911883, 2193.616117179487, 2220.7335119785566, 2228.0419419649543, 9039.728808135766, 9299.209567186797, 9377.859332110023, 9978.351407158512, 13943.02398832072, 1762.7620271263343, 1876.1744832273891, 1905.7903630600622, 1907.4849790556611, 1931.6329897319604, 75495.62252188759, 83280.58359708224, 85039.5748021256, 85364.57317713434, 85476.0, 10015.549300281506, 10676.679699609023, 11169.0, 11171.944140279247, 11218.831717524243, 15547.378104875905, 15616.76574851378, 15627.0, 15639.218039098227, 15715.607109822346, 7943.285104340637, 8106.878396824052, 8115.513069215866, 8195.754127376189, 8223.876641850376, 7391.0761154855645, 7450.515716478411, 7703.768886933401, 7765.563370776425, 7771.417143714244, 4433.578810013044, 4479.350494178326, 4485.775711214426, 4514.119746649438, 4719.126961512131, 1808.3868809570045, 1830.3502256698946, 1873.194526353681, 2017.7578690557227, 2058.7735349111585, 987.7876256604865, 1050.611273828673, 1066.269605320358, 1088.8911108889047, 1091.6724982505216, 16911.408100716417, 17127.229274682668, 17465.91267043682, 17905.0, 18298.988385162982, 993.8310487217191, 1003.4531180506641, 1020.2450186861669, 1031.3605564550028, 1056.0706578211125, 10134.847977280348, 10146.239032072624, 10698.839517407245, 10778.94610526958, 10831.891681083245, 490965.0, 508233.0, 509283.0, 523455.0, 527194.0, 61748.38251617516, 62992.0, 100234.49882750539, 102373.48813255886, 104550.47724761328, 1048.0881632979203, 1063.1229235880276, 1065.9307145035548, 1068.0, 1098.1215027977587, 16434.863467749594, 16669.99980001204, 16826.915865420593, 16967.151642418077, 17155.142242888054, 37366.439503406924, 39070.60929390784, 39547.0, 39851.60256250256, 40197.0, 56484.435155647916, 57763.422365775805, 57929.710351449656, 58505.0, 59221.0, 6987.336203060701, 7494.925050749423, 7512.248775122444, 7849.646765895663, 8304.29413499835, 8725.127487251224, 11814.232074915102, 12805.295708736108, 12879.806802897776, 12961.611151665466, 11496.597619083292, 11779.705507362385, 11847.348395838311, 11998.0, 12108.878911210775, 11409.0, 11514.481848316678, 11630.185886987829, 11631.127665425296, 11687.415629218674, 11451.713707157387, 11683.591074312359, 12114.575989840314, 12159.270443773403, 12258.20321679088, 7182.209956904632, 7457.92542074594, 7475.0656167979005, 7529.661165247687, 7649.158592554703, 11396.0, 11402.144839136932, 11626.53493860236, 11703.76592468163, 12124.090693198223], "value": 8881.436054235435, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1479.933402996865, 1513.8864585156114, 1617.6845515124548, 1694.9322027118915, 1695.4235559909628, 7363.226861179566, 7652.426068044898, 7831.490953088045, 7860.803479913005, 7864.685412583497, 7835.138134805167, 7898.328642065431, 7959.602019899011, 7961.1242763295995, 8013.07849597295, 2270.9886450567765, 2295.5064661097863, 2296.59809533331, 2302.827287953402, 2304.850184737995, 2187.9343619691354, 2203.55928814237, 2218.8779617121054, 2231.241377931503, 2232.4195709115584, 2203.2619072610696, 2241.2155745489113, 2247.6965609642734, 2254.030766770288, 2267.036509483463, 2184.737831460227, 2189.397915573214, 2197.2199869046417, 2203.1187524989973, 2204.526026904215, 2234.6312858378346, 2235.698180745595, 2237.093976939342, 2258.446680563256, 2261.615525360676, 7963.562004089773, 8019.67921283148, 8113.7565873023905, 8121.269085782249, 8121.837563248702, 4990.3762029746285, 5099.4900509949075, 5128.615353848439, 5144.948550514484, 5179.792808287664, 3334.983325083359, 3340.749443791701, 3376.40912840252, 3423.9486407703903, 3436.1581412553833, 1106.9778604427866, 1107.534835369147, 1121.0919155484085, 1139.709374109605, 1153.9826902596383, 11169.832452513137, 11182.440877956069, 11190.272632278877, 11227.382493962828, 11253.943730281379, 4320.092780516064, 4433.733975961452, 4488.371627972087, 4492.483364413134, 4728.290756386501, 8613.09562495929, 8650.653973841101, 8659.0, 8701.26039286655, 8710.085441028728, 4857.95142048575, 4878.000009997942, 4882.316475693406, 4891.633127515451, 4904.926426103611, 4080.510338759368, 4513.909721805611, 4604.631629469634, 4616.8614941551805, 4625.398698169217, 3766.152615661454, 3843.7501562398356, 3860.864869729546, 3913.7651740895635, 3978.3634618461488, 1149.7298134938283, 1154.7401834587151, 1162.3084264862393, 1171.1216587559331, 1218.7988981818078, 880.0, 968.2834702320373, 974.444566597047, 981.2248323824242, 989.1098011789303, 5728.856778580569, 5775.393583673654, 5866.208061911588, 5877.39719539972, 5978.8206353809455, 912.8767616371838, 919.852823548229, 924.366808736018, 1005.2209537608265, 1020.4387586827364, 4000.6399424051974, 4038.51537815464, 4068.145689405258, 4071.0840060986634, 4073.3889916512167, 10360.222983276284, 10546.894531054591, 10597.152227821756, 10684.0, 10715.303505272132, 10453.163746900229, 10593.364398136137, 10593.735156620993, 10609.045185933148, 10626.14990800734, 7741.264579864904, 7921.801954951057, 7992.560409177435, 8001.519908805491, 8013.479123857047, 5583.246261754611, 5800.854978625568, 5823.79616713413, 5863.472287493975, 5909.8227053188475, 9456.527173641429, 9483.478408687588, 9533.189678877374, 9630.759231019281, 9633.373830700983, 9597.616095356387, 9624.326297159132, 9907.752306192402, 9920.801583968425, 9944.801103977736, 6898.275681053417, 7066.187388450394, 7248.637568121679, 7266.564006159648, 7299.124105107208, 7701.6534255957495, 7734.419918506022, 7735.0, 7771.37828973692, 7806.882896756667, 6911.619860907698, 7086.858262834611, 7174.2108368078425, 7191.604461754445, 7272.563646181246, 7013.333733295329, 7020.719171233298, 7081.610511421921, 7096.574205547684, 7122.074130363019, 6342.809715708536, 6550.705218265094, 6557.2131344239, 6562.475001999924, 6577.408033276836, 4961.776720047535, 5120.052790233819, 5171.431142574389, 5184.092783762751, 5199.012187684328, 5174.275601415729, 5199.440167949676, 5202.869928251824, 5231.529162375405, 5292.576593872404], "value": 4433.186028171767, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [304.08470503783604, 307.3346205465169, 310.1393632669343, 312.1789693107128, 319.270466982944, 5711.942880571203, 5937.139114828347, 5964.284285885695, 5964.956132676781, 6071.908921366183, 5947.643141411508, 6021.561267686583, 6027.487663548603, 6029.8191054268445, 6036.788712395067, 4524.547545245482, 4545.568171023748, 4545.727256364612, 4559.498455169929, 4571.748553829538, 4442.577955094261, 4566.70316429431, 4586.816527338902, 4594.356790049395, 4605.585497305242, 4460.524408953046, 4486.842960496383, 4499.955000449986, 4507.706999045052, 4515.435570553681, 4509.684322097454, 4512.345709872066, 4521.321801729734, 4524.796384162688, 4544.840930567414, 3875.283072631544, 3929.3909444035935, 3955.9406608900604, 3958.881233562969, 3971.5829837867186, 5738.225339579145, 5786.971065144689, 5802.303723553201, 5806.361300256968, 5823.912641310384, 5156.9742151289, 5190.143626301693, 5195.6622819516615, 5213.791448342062, 5249.343832020997, 6080.2399700037495, 6275.686215689243, 6285.528585356071, 6295.464885484739, 6301.464375528086, 4325.935110973338, 4332.241857674894, 4343.131373725268, 4350.108227813323, 4351.804168812379, 6399.168108145957, 6550.868982620321, 6581.341865813428, 6598.373154550358, 6630.138082049351, 4381.802818873159, 4397.560243975641, 4398.186335527937, 4422.402975598253, 4436.6672499562665, 4445.0, 4453.77731113443, 4486.506484286726, 4492.865214043584, 4500.032493014018, 5217.34783152106, 5232.581393488512, 5253.317068781111, 5262.079136151158, 5265.104932161542, 6051.425114614105, 6068.666223357669, 6214.2542894852, 6326.430621244018, 6411.166548348778, 1514.3639671338065, 1528.465037236958, 1529.6405344743976, 1535.5163123616248, 1535.7466018106886, 990.390909590611, 1001.3391161833155, 1009.9091081802673, 1015.8520871415253, 1021.7292417509366, 6001.399860014051, 6022.728977196037, 6029.909551356734, 6034.758609655652, 6067.54493412987, 6424.293327733945, 6471.482281417475, 6494.967525162344, 6499.220093588705, 6552.3775241352, 5773.422657734193, 5961.195238642727, 5991.191189189491, 6018.668973206428, 6019.307779605314, 3469.2020835208045, 3483.4252348362743, 3493.12671832042, 3496.7727097738566, 3501.5447991761416, 6475.0, 6659.134312539436, 6809.353111454404, 6835.829104272333, 6846.7945961621235, 6711.765088221987, 6721.462283017445, 6722.226943901514, 6740.460763138937, 6753.831154221086, 6532.477401807844, 6796.524243302922, 6816.863662726718, 6882.109514004131, 6893.931060689329, 6437.324080971431, 6438.227412710505, 6490.026496025634, 6596.637184954873, 6607.504437167136, 6159.5688301818445, 6419.550631455753, 6432.195975503062, 6453.903191452038, 6455.580387274812, 6775.695093720893, 6779.89830152558, 6822.488313376616, 6828.931710682829, 6853.211880633591, 4320.783960801885, 4328.956710432855, 4330.545292744217, 4344.565543445757, 4359.411479450234, 6373.6494492801485, 6401.679916004275, 6539.574927629689, 6581.539292249497, 6596.769113081019, 6300.59046161998, 6334.651594162366, 6359.3640635936035, 6361.2048493938255, 6365.713542890674, 6131.509479241561, 6248.125262463168, 6342.112104305494, 6343.238811342669, 6364.427201551883, 6205.193324867739, 6209.906851397323, 6257.906131407942, 6272.0, 6294.937050629435, 6359.586626869239, 6370.522210834113, 6449.871002579828, 6465.903011454926, 6474.676266186766, 5981.431763982415, 6277.027060805583, 6327.209098862642, 6336.873262534816, 6349.8730025400155], "value": 4728.595032635023, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [694.5069001009283, 717.9497435179538, 725.5356571794051, 756.1417790807432, 763.5266134996307, 12174.939125304372, 12249.571265005727, 12296.815547766768, 12357.814632780515, 12485.375731213437, 13670.384832682528, 14076.366563504642, 14159.858401415982, 14173.645658858533, 14212.573622791333, 675.810772983563, 813.1340122769246, 815.4373482297226, 816.5508970066469, 817.3297895725508, 787.5353541410567, 807.2290962131151, 807.5598798654718, 811.452269717941, 811.7727036429809, 834.1366685480529, 838.7232213369604, 841.5876220651897, 842.2335674536173, 843.1105184030845, 831.4263158420671, 838.3586556284478, 838.8532006898769, 839.4501601451029, 841.5539763925068, 605.530713696884, 608.5527137553938, 608.7504123309421, 613.0314103716117, 613.8066509049635, 12730.681732956658, 12810.29543375114, 12823.61529154127, 12874.227546347156, 12879.356032198353, 12850.293233872133, 12876.871231287661, 13102.47590096395, 13224.206547607175, 13461.932690336485, 10423.530941107592, 10500.21248406365, 10592.205584581186, 10632.946835265775, 10641.840372394421, 3790.90522736931, 3864.8260828262796, 3884.8251828667776, 3900.921981560353, 3936.645701886844, 57678.0, 59408.40591594072, 59447.40552594462, 59902.70048649773, 59913.0, 10308.896911030944, 10628.0, 10647.520861561248, 10769.138468922467, 10776.353418794897, 17785.28858845632, 17841.643167136586, 17886.821131788776, 17940.102994850204, 18000.729989050174, 7741.032370953631, 7799.259070388304, 7824.530528168328, 7946.602669866484, 8204.8359032819, 4436.933445998313, 4454.04238088806, 4517.412736344254, 4561.817527298937, 4672.112298663243, 3108.797928134664, 3196.7122958933805, 3199.5360672702327, 3205.3268813549416, 3219.4526930421885, 575.5654480866918, 587.6289173186174, 601.2994860986902, 602.2923065398139, 606.4481321996961, 587.3157771196509, 694.0976730250654, 700.656678227675, 702.4871843554234, 714.4891402647132, 8542.572871356408, 8657.177568131017, 8826.602802873886, 8895.73312800617, 9163.81672366549, 589.8201048680108, 601.666075328197, 656.0, 668.488606216245, 670.8155257304182, 4481.0, 4490.753008584494, 4528.6377089833395, 4665.743384113906, 4672.2057250267535, 61647.383526164165, 64426.35573644297, 64485.0, 64879.675601622635, 65224.0, 56057.71971140118, 57708.42291577031, 58019.709901450224, 58355.0, 59292.0, 41151.794241028605, 41836.372454413206, 46517.30224046642, 48715.26927096096, 49470.0, 8722.738317850475, 8828.867566986371, 9009.324300677345, 9150.954245228731, 9288.0, 30740.538891916192, 30954.0, 31562.684373155975, 31863.203419914687, 32184.19539511531, 44891.85756996979, 46223.30665040094, 46925.3576124834, 48537.02925941391, 49454.50545494499, 12168.695782605151, 12215.450304736485, 12222.388880556115, 12304.323262220663, 12459.688507787016, 12549.498020079094, 12857.292848893401, 13174.275414852274, 13532.86467135316, 13573.660658483617, 12324.938375308066, 12539.811902821282, 12565.183263088236, 12603.24380537134, 12683.23900565969, 12500.437480313225, 12735.681607959876, 12738.68153296138, 12762.744745104861, 12865.0, 12205.20666156697, 12296.877031229573, 12429.875701243234, 12649.177803442746, 12748.872511274769, 10443.94778026105, 10609.787804244026, 10705.625303114353, 10708.0, 10918.12654987615, 10217.795644086927, 10389.0, 10394.750650921236, 10401.323913945569, 10467.371957682564], "value": 6559.98595756466, "unit": "score"}], "name": "dromaeo_css", "value": 6982.966248304279, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 106.0, 112.0, 113.0, 112.0, 124.0, 113.0, 113.0, 111.0, 110.0], "value": 112.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 128.0, 162.0, 182.0, 130.0, 155.0, 156.0, 134.0, 185.0, 130.0], "value": 151.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 162.0, 164.0, 161.0, 162.0, 173.0, 162.0, 165.0, 163.0], "value": 163.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 77.0, 78.0, 145.0, 78.0, 74.0, 78.0, 73.0, 157.0, 73.0], "value": 90.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 93.0, 152.0, 93.0, 92.0, 92.0, 154.0, 93.0, 92.0, 151.0], "value": 110.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 118.0, 117.0, 118.0, 117.0, 118.0, 118.0], "value": 117.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 148.0, 147.0, 150.0, 147.0, 148.0, 147.0, 147.0, 147.0, 147.0], "value": 147.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 94.0, 96.0, 95.0, 94.0, 96.0, 95.0, 95.0, 95.0], "value": 95.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 58.0, 58.0, 58.0, 60.0, 64.0, 57.0, 82.0, 56.0, 64.0], "value": 61.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 63.0, 65.0, 64.0, 64.0, 62.0, 62.0, 68.0, 62.0, 62.0], "value": 63.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 77.0, 80.0, 87.0, 78.0, 79.0, 78.0, 79.0, 81.0], "value": 79.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [126.0, 128.0, 135.0, 126.0, 128.0, 129.0, 124.0, 127.0, 158.0, 146.0], "value": 132.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [172.0, 178.0, 174.0, 167.0, 177.0, 170.0, 175.0, 169.0, 166.0, 167.0], "value": 171.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 71.0, 71.0, 70.0, 73.0, 68.0, 68.0, 69.0, 69.0, 68.0], "value": 69.6, "unit": "score"}], "name": "kraken", "value": 1566.7, "alertThreshold": 2.0}]} 06:17:49 INFO - Return code: 0 06:17:49 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 06:17:49 ERROR - # TBPL SUCCESS # 06:17:49 INFO - Running post-action listener: _resource_record_post_action 06:17:49 INFO - Running post-run listener: _resource_record_post_run 06:17:50 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 7790592; Write bytes: 471207936; Read time: 1596; Write time: 377248 06:17:50 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 20189184; Read time: 0; Write time: 15296 06:17:50 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 6029312; Write bytes: 451018752; Read time: 1548; Write time: 361952 06:17:50 INFO - Running post-run listener: _upload_blobber_files 06:17:50 INFO - Blob upload gear active. 06:17:50 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:17:50 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 06:17:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:17:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:17:50 INFO - (blobuploader) - INFO - Open directory for files ... 06:17:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:17:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:17:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:17:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:17:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:17:51 INFO - (blobuploader) - INFO - Done attempting. 06:17:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:17:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:17:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:17:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:17:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:17:52 INFO - (blobuploader) - INFO - Done attempting. 06:17:52 INFO - (blobuploader) - INFO - Iteration through files over. 06:17:52 INFO - Return code: 0 06:17:52 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:17:52 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:17:52 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e4154d9e6620e9bbe2214680359475ba35daffbe5ef4971e01d7d1bce9dabd6ac5bfe01888ee4672809b395d61bea098d916e13aaa058943f4dd3d4a65ad11fa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5239a5d405e494b213b98c09da77fda4d68c2ef4555f6a21aa3d165d1629ed8b6765996761a5416a0f1461c1ee90a7b85532042d6944d2e48895c2a827d3e127"} 06:17:52 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:17:52 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:17:52 INFO - Contents: 06:17:52 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e4154d9e6620e9bbe2214680359475ba35daffbe5ef4971e01d7d1bce9dabd6ac5bfe01888ee4672809b395d61bea098d916e13aaa058943f4dd3d4a65ad11fa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5239a5d405e494b213b98c09da77fda4d68c2ef4555f6a21aa3d165d1629ed8b6765996761a5416a0f1461c1ee90a7b85532042d6944d2e48895c2a827d3e127"} 06:17:52 INFO - Running post-run listener: copy_logs_to_upload_dir 06:17:52 INFO - Copying logs to upload dir... 06:17:52 INFO - mkdir: /builds/slave/test/build/upload/logs 06:17:52 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.646253 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-04-17 06:17:52.265819) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-17 06:17:52.273512) ========= 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=82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949 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/Firefox/sha512/e4154d9e6620e9bbe2214680359475ba35daffbe5ef4971e01d7d1bce9dabd6ac5bfe01888ee4672809b395d61bea098d916e13aaa058943f4dd3d4a65ad11fa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5239a5d405e494b213b98c09da77fda4d68c2ef4555f6a21aa3d165d1629ed8b6765996761a5416a0f1461c1ee90a7b85532042d6944d2e48895c2a827d3e127"} build_url:https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011275 build_url: 'https://queue.taskcluster.net/v1/task/Wb5HolQIRuGcvhUWMm7hNg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e4154d9e6620e9bbe2214680359475ba35daffbe5ef4971e01d7d1bce9dabd6ac5bfe01888ee4672809b395d61bea098d916e13aaa058943f4dd3d4a65ad11fa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5239a5d405e494b213b98c09da77fda4d68c2ef4555f6a21aa3d165d1629ed8b6765996761a5416a0f1461c1ee90a7b85532042d6944d2e48895c2a827d3e127"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-17 06:17:52.301161) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-17 06:17:52.301542) ========= 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=82e07478c745e68b1fe4678a000001bc-1460895070.821853-352002949 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004406 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-17 06:17:52.354189) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-17 06:17:52.354549) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-17 06:17:52.354901) ========= ========= Total master_lag: 0.19 =========