builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-013 starttime: 1460642233.41 results: success (0) buildid: 20160414033646 builduid: f98ee03d4ff747f4ab1bc37afd36528c revision: e4d417a8b34cc19ca33b030aa8eafb32a98d3bb7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.408957) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.410983) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.411321) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.432124) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.432938) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-14 06: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.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 65.8M=0s 2016-04-14 06:57:13 (65.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.167015 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.613830) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.614186) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017687 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.664247) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:13.664624) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev e4d417a8b34cc19ca33b030aa8eafb32a98d3bb7 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev e4d417a8b34cc19ca33b030aa8eafb32a98d3bb7 --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=9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-14 06:57:13,847 truncating revision to first 12 chars 2016-04-14 06:57:13,847 Setting DEBUG logging. 2016-04-14 06:57:13,848 attempt 1/10 2016-04-14 06:57:13,848 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/e4d417a8b34c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-14 06:57:14,107 unpacking tar archive at: mozilla-aurora-e4d417a8b34c/testing/mozharness/ program finished with exit code 0 elapsedTime=0.572771 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:14.250765) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:14.251145) ========= script_repo_revision: e4d417a8b34cc19ca33b030aa8eafb32a98d3bb7 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:14.251645) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:14.251927) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-14 06:57:14.262564) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 29 secs) (at 2016-04-14 06:57:14.262979) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:57:14 INFO - MultiFileLogger online at 20160414 06:57:14 in /builds/slave/test 06:57:14 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 06:57:14 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:57:14 INFO - {'append_to_log': False, 06:57:14 INFO - 'base_work_dir': '/builds/slave/test', 06:57:14 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 06:57:14 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:57:14 INFO - 'branch': 'Mozilla-Aurora', 06:57:14 INFO - 'buildbot_json_path': 'buildprops.json', 06:57:14 INFO - 'config_files': ('talos/linux_config.py',), 06:57:14 INFO - 'default_actions': ('clobber', 06:57:14 INFO - 'read-buildbot-config', 06:57:14 INFO - 'download-and-extract', 06:57:14 INFO - 'populate-webroot', 06:57:14 INFO - 'create-virtualenv', 06:57:14 INFO - 'install', 06:57:14 INFO - 'run-tests'), 06:57:14 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:57:14 INFO - 'download_minidump_stackwalk': True, 06:57:14 INFO - 'download_symbols': 'ondemand', 06:57:14 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:57:14 INFO - 'tooltool.py': '/tools/tooltool.py', 06:57:14 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:57:14 INFO - '/tools/misc-python/virtualenv.py')}, 06:57:14 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:57:14 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:57:14 INFO - 'installer_path': 'installer.exe', 06:57:14 INFO - 'log_level': 'info', 06:57:14 INFO - 'log_name': 'talos', 06:57:14 INFO - 'log_to_console': True, 06:57:14 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:57:14 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:57:14 INFO - 'opt_config_files': (), 06:57:14 INFO - 'pip_index': False, 06:57:14 INFO - 'sps_profile': False, 06:57:14 INFO - 'sps_profile_interval': 0, 06:57:14 INFO - 'suite': 'dromaeojs-e10s', 06:57:14 INFO - 'system_bits': '32', 06:57:14 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:57:14 INFO - 'title': 'talos-linux64-ix-013', 06:57:14 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:57:14 INFO - 'use_talos_json': True, 06:57:14 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:57:14 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:57:14 INFO - 'work_dir': 'build'} 06:57:14 INFO - ##### 06:57:14 INFO - ##### Running clobber step. 06:57:14 INFO - ##### 06:57:14 INFO - Running pre-action listener: _resource_record_pre_action 06:57:14 INFO - Running main action method: clobber 06:57:14 INFO - rmtree: /builds/slave/test/build 06:57:14 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:57:15 INFO - Running post-action listener: _resource_record_post_action 06:57:15 INFO - ##### 06:57:15 INFO - ##### Running read-buildbot-config step. 06:57:15 INFO - ##### 06:57:15 INFO - Running pre-action listener: _resource_record_pre_action 06:57:15 INFO - Running main action method: read_buildbot_config 06:57:15 INFO - Using buildbot properties: 06:57:15 INFO - { 06:57:15 INFO - "project": "", 06:57:15 INFO - "product": "firefox", 06:57:15 INFO - "script_repo_revision": "production", 06:57:15 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 06:57:15 INFO - "repository": "", 06:57:15 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 06:57:15 INFO - "buildid": "20160414033646", 06:57:15 INFO - "pgo_build": "True", 06:57:15 INFO - "basedir": "/builds/slave/test", 06:57:15 INFO - "buildnumber": 201, 06:57:15 INFO - "slavename": "talos-linux64-ix-013", 06:57:15 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 06:57:15 INFO - "platform": "ubuntu64_hw", 06:57:15 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 06:57:15 INFO - "branch": "mozilla-aurora", 06:57:15 INFO - "repo_path": "releases/mozilla-aurora", 06:57:15 INFO - "revision": "e4d417a8b34cc19ca33b030aa8eafb32a98d3bb7", 06:57:15 INFO - "stage_platform": "linux64-pgo", 06:57:15 INFO - "builduid": "f98ee03d4ff747f4ab1bc37afd36528c", 06:57:15 INFO - "slavebuilddir": "test" 06:57:15 INFO - } 06:57:15 INFO - Found installer url https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2. 06:57:15 INFO - Running post-action listener: _resource_record_post_action 06:57:15 INFO - ##### 06:57:15 INFO - ##### Running download-and-extract step. 06:57:15 INFO - ##### 06:57:15 INFO - Running pre-action listener: _resource_record_pre_action 06:57:15 INFO - Running main action method: download_and_extract 06:57:15 INFO - mkdir: /builds/slave/test/build/tests 06: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')]} 06:57:15 INFO - https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 06:57:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 06:57:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 06:57:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 06:57:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 06:57:17 INFO - Downloaded 1448 bytes. 06:57:17 INFO - Reading from file /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 06:57:17 INFO - Using the following test package requirements: 06:57:17 INFO - {u'common': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 06:57:17 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 06:57:17 INFO - u'firefox-47.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 06:57:17 INFO - u'gtest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 06:57:17 INFO - u'firefox-47.0a2.en-US.linux-x86_64.gtest.tests.zip'], 06:57:17 INFO - u'jittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 06:57:17 INFO - u'jsshell-linux-x86_64.zip'], 06:57:17 INFO - u'mochitest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 06:57:17 INFO - u'firefox-47.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 06:57:17 INFO - u'mozbase': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 06:57:17 INFO - u'reftest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 06:57:17 INFO - u'firefox-47.0a2.en-US.linux-x86_64.reftest.tests.zip'], 06:57:17 INFO - u'talos': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 06:57:17 INFO - u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'], 06:57:17 INFO - u'web-platform': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 06:57:17 INFO - u'firefox-47.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 06:57:17 INFO - u'webapprt': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 06:57:17 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 06:57:17 INFO - u'firefox-47.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 06:57:17 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:57:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:17 INFO - https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:57:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 06:57:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 06:57:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 06:57:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:57:19 INFO - Downloaded 23352099 bytes. 06:57:19 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 06:57:19 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 06:57:20 INFO - Return code: 0 06:57:20 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 06:57:20 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')]} 06:57:20 INFO - https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:57:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 06:57:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 06:57:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 06:57:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:57:22 INFO - Downloaded 23352099 bytes. 06:57:22 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 06:57:22 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 06:57:24 INFO - Return code: 0 06:57:24 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')]} 06:57:24 INFO - https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 06:57:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 06:57:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 06:57:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 06:57:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 06:57:26 INFO - Downloaded 10845168 bytes. 06:57:26 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 06:57:26 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 06:57:26 INFO - Return code: 0 06: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')]} 06:57:26 INFO - https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 06:57:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 06:57:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 06:57:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 06:57:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 06:57:28 INFO - Downloaded 60577267 bytes. 06:57:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 06:57:28 INFO - mkdir: /builds/slave/test/properties 06:57:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:57:28 INFO - Writing to file /builds/slave/test/properties/build_url 06:57:28 INFO - Contents: 06:57:28 INFO - build_url:https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 06:57:29 INFO - Running post-action listener: _resource_record_post_action 06:57:29 INFO - Running post-action listener: set_extra_try_arguments 06:57:29 INFO - ##### 06:57:29 INFO - ##### Running populate-webroot step. 06:57:29 INFO - ##### 06:57:29 INFO - Running pre-action listener: _resource_record_pre_action 06:57:29 INFO - Running main action method: populate_webroot 06:57:29 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:57:29 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:57:29 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:57:29 INFO - '--tppagecycles', 06:57:29 INFO - '7'], 06:57:29 INFO - 'tests': ['tsvgm']}}, 06:57:29 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 06:57:29 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:57:29 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 06:57:29 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:57:29 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:57:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:57:29 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:57:29 INFO - 'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:57:29 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:57:29 INFO - 'tests': ['damp', 'tps']}, 06:57:29 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:57:29 INFO - 'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['damp', 'tps']}, 06:57:29 INFO - 'g3': {'tests': ['dromaeo_dom']}, 06:57:29 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:57:29 INFO - 'other': {'tests': ['a11yr', 06:57:29 INFO - 'ts_paint', 06:57:29 INFO - 'tpaint', 06:57:29 INFO - 'sessionrestore', 06:57:29 INFO - 'sessionrestore_no_auto_restore', 06:57:29 INFO - 'tabpaint']}, 06:57:29 INFO - 'other-e10s': {'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['a11yr', 06:57:29 INFO - 'ts_paint', 06:57:29 INFO - 'tpaint', 06:57:29 INFO - 'sessionrestore', 06:57:29 INFO - 'sessionrestore_no_auto_restore', 06:57:29 INFO - 'tabpaint']}, 06:57:29 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['a11yr', 06:57:29 INFO - 'ts_paint', 06:57:29 INFO - 'tpaint', 06:57:29 INFO - 'sessionrestore', 06:57:29 INFO - 'sessionrestore_no_auto_restore', 06:57:29 INFO - 'tabpaint']}, 06:57:29 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['a11yr', 06:57:29 INFO - 'ts_paint', 06:57:29 INFO - 'tpaint', 06:57:29 INFO - 'sessionrestore', 06:57:29 INFO - 'sessionrestore_no_auto_restore', 06:57:29 INFO - 'tabpaint']}, 06:57:29 INFO - 'other_l64': {'tests': ['a11yr', 06:57:29 INFO - 'ts_paint', 06:57:29 INFO - 'tpaint', 06:57:29 INFO - 'sessionrestore', 06:57:29 INFO - 'sessionrestore_no_auto_restore', 06:57:29 INFO - 'tabpaint']}, 06:57:29 INFO - 'other_nol64': {'tests': ['a11yr', 06:57:29 INFO - 'ts_paint', 06:57:29 INFO - 'tpaint', 06:57:29 INFO - 'sessionrestore', 06:57:29 INFO - 'sessionrestore_no_auto_restore', 06:57:29 INFO - 'tabpaint']}, 06:57:29 INFO - 'svgr': {'tests': ['tsvgx', 06:57:29 INFO - 'tsvgr_opacity', 06:57:29 INFO - 'tart', 06:57:29 INFO - 'tscrollx', 06:57:29 INFO - 'cart']}, 06:57:29 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['tsvgx', 06:57:29 INFO - 'tsvgr_opacity', 06:57:29 INFO - 'tart', 06:57:29 INFO - 'tscrollx', 06:57:29 INFO - 'cart']}, 06:57:29 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:57:29 INFO - 'tests': ['tp5o']}, 06:57:29 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:57:29 INFO - 'talos_options': ['--e10s'], 06:57:29 INFO - 'tests': ['tp5o']}, 06:57:29 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:57:29 INFO - 'talos_options': ['--xperf_path', 06:57:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:57:29 INFO - 'tests': ['tp5n']}, 06:57:29 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:57:29 INFO - 'talos_options': ['--e10s', 06:57:29 INFO - '--xperf_path', 06:57:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:57:29 INFO - 'tests': ['tp5n']}}, 06:57:29 INFO - 'talos.zip': {'path': '', 06:57:29 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:57:29 INFO - Running post-action listener: _resource_record_post_action 06:57:29 INFO - ##### 06:57:29 INFO - ##### Running create-virtualenv step. 06:57:29 INFO - ##### 06:57:29 INFO - Running pre-action listener: _resource_record_pre_action 06:57:29 INFO - Running main action method: create_virtualenv 06:57:29 INFO - Creating virtualenv /builds/slave/test/build/venv 06:57:29 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 06:57:29 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:57:29 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:57:29 INFO - Using real prefix '/usr' 06:57:29 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:57:29 INFO - Installing distribute.............................................................................................................................................................................................done. 06:57:31 INFO - Installing pip.................done. 06:57:31 INFO - Return code: 0 06:57:31 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:57:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:31 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 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:31 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 06:57:31 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 06:57:31 INFO - Using env: {'DISPLAY': ':0', 06:57:31 INFO - 'HOME': '/home/cltbld', 06:57:31 INFO - 'LANG': 'en_US.UTF-8', 06:57:31 INFO - 'LANGUAGE': 'en_US:en', 06:57:31 INFO - 'LOGNAME': 'cltbld', 06:57:31 INFO - 'MAIL': '/var/mail/cltbld', 06:57:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:31 INFO - 'MOZ_NO_REMOTE': '1', 06:57:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:31 INFO - 'NO_EM_RESTART': '1', 06:57:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:31 INFO - 'PWD': '/builds/slave/test', 06:57:31 INFO - 'SHELL': '/bin/bash', 06:57:31 INFO - 'SHLVL': '1', 06:57:31 INFO - 'TERM': 'linux', 06:57:31 INFO - 'TMOUT': '86400', 06:57:31 INFO - 'USER': 'cltbld', 06:57:31 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:31 INFO - '_': '/tools/buildbot/bin/python'} 06:57:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:31 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 06:57:31 INFO - Cleaning up... 06:57:31 INFO - Return code: 0 06:57:31 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 06:57:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:31 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 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:31 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 06:57:31 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 06:57:31 INFO - Using env: {'DISPLAY': ':0', 06:57:31 INFO - 'HOME': '/home/cltbld', 06:57:31 INFO - 'LANG': 'en_US.UTF-8', 06:57:31 INFO - 'LANGUAGE': 'en_US:en', 06:57:31 INFO - 'LOGNAME': 'cltbld', 06:57:31 INFO - 'MAIL': '/var/mail/cltbld', 06:57:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:31 INFO - 'MOZ_NO_REMOTE': '1', 06:57:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:31 INFO - 'NO_EM_RESTART': '1', 06:57:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:31 INFO - 'PWD': '/builds/slave/test', 06:57:31 INFO - 'SHELL': '/bin/bash', 06:57:31 INFO - 'SHLVL': '1', 06:57:31 INFO - 'TERM': 'linux', 06:57:31 INFO - 'TMOUT': '86400', 06:57:31 INFO - 'USER': 'cltbld', 06:57:31 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:31 INFO - '_': '/tools/buildbot/bin/python'} 06:57:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:32 INFO - Downloading/unpacking psutil>=0.7.1 06:57:32 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 06:57:32 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 06:57:32 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 06:57:32 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 06:57:32 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 06:57:32 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 06:57:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:57:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:57:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:57:34 INFO - Installing collected packages: psutil 06:57:34 INFO - Running setup.py install for psutil 06:57:34 INFO - building 'psutil._psutil_linux' extension 06:57:34 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 06:57:34 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 06:57:34 INFO - building 'psutil._psutil_posix' extension 06:57:34 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 06:57:34 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 06:57:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:57:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:57:34 INFO - Successfully installed psutil 06:57:34 INFO - Cleaning up... 06:57:34 INFO - Return code: 0 06:57:34 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 06:57:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:34 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 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:34 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 06:57:34 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 06:57:34 INFO - Using env: {'DISPLAY': ':0', 06:57:34 INFO - 'HOME': '/home/cltbld', 06:57:34 INFO - 'LANG': 'en_US.UTF-8', 06:57:34 INFO - 'LANGUAGE': 'en_US:en', 06:57:34 INFO - 'LOGNAME': 'cltbld', 06:57:34 INFO - 'MAIL': '/var/mail/cltbld', 06:57:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:34 INFO - 'MOZ_NO_REMOTE': '1', 06:57:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:34 INFO - 'NO_EM_RESTART': '1', 06:57:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:34 INFO - 'PWD': '/builds/slave/test', 06:57:34 INFO - 'SHELL': '/bin/bash', 06:57:34 INFO - 'SHLVL': '1', 06:57:34 INFO - 'TERM': 'linux', 06:57:34 INFO - 'TMOUT': '86400', 06:57:34 INFO - 'USER': 'cltbld', 06:57:34 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:34 INFO - '_': '/tools/buildbot/bin/python'} 06:57:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:34 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 06: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 06: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 06: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 06: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 06: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 06: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 06:57:36 INFO - Downloading mozsystemmonitor-0.0.tar.gz 06:57:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:57:36 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 06:57:36 INFO - Installing collected packages: mozsystemmonitor 06:57:36 INFO - Running setup.py install for mozsystemmonitor 06:57:37 INFO - Successfully installed mozsystemmonitor 06:57:37 INFO - Cleaning up... 06:57:37 INFO - Return code: 0 06:57:37 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:57:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 06:57:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 06:57:37 INFO - Using env: {'DISPLAY': ':0', 06:57:37 INFO - 'HOME': '/home/cltbld', 06:57:37 INFO - 'LANG': 'en_US.UTF-8', 06:57:37 INFO - 'LANGUAGE': 'en_US:en', 06:57:37 INFO - 'LOGNAME': 'cltbld', 06:57:37 INFO - 'MAIL': '/var/mail/cltbld', 06:57:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:37 INFO - 'MOZ_NO_REMOTE': '1', 06:57:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:37 INFO - 'NO_EM_RESTART': '1', 06:57:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:37 INFO - 'PWD': '/builds/slave/test', 06:57:37 INFO - 'SHELL': '/bin/bash', 06:57:37 INFO - 'SHLVL': '1', 06:57:37 INFO - 'TERM': 'linux', 06:57:37 INFO - 'TMOUT': '86400', 06:57:37 INFO - 'USER': 'cltbld', 06:57:37 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:37 INFO - '_': '/tools/buildbot/bin/python'} 06:57:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:37 INFO - Downloading/unpacking blobuploader==1.2.4 06:57:37 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 06:57:37 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 06:57:37 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 06:57:37 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 06:57:37 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 06:57:37 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 06:57:39 INFO - Downloading blobuploader-1.2.4.tar.gz 06:57:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:57:39 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:57:39 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 06:57:39 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 06:57:39 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 06:57:39 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 06:57:39 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 06:57:39 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 06:57:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:57:39 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:57:39 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 06:57:39 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 06:57:39 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 06:57:39 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 06:57:39 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 06:57:39 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 06:57:39 INFO - Downloading docopt-0.6.1.tar.gz 06:57:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:57:39 INFO - Installing collected packages: blobuploader, requests, docopt 06:57:39 INFO - Running setup.py install for blobuploader 06:57:39 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:57:39 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:57:40 INFO - Running setup.py install for requests 06:57:40 INFO - Running setup.py install for docopt 06:57:40 INFO - Successfully installed blobuploader requests docopt 06:57:40 INFO - Cleaning up... 06:57:40 INFO - Return code: 0 06:57:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06: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')]} 06:57:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06: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')]} 06:57:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:40 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 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:40 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 06:57:40 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 06:57:40 INFO - Using env: {'DISPLAY': ':0', 06:57:40 INFO - 'HOME': '/home/cltbld', 06:57:40 INFO - 'LANG': 'en_US.UTF-8', 06:57:40 INFO - 'LANGUAGE': 'en_US:en', 06:57:40 INFO - 'LOGNAME': 'cltbld', 06:57:40 INFO - 'MAIL': '/var/mail/cltbld', 06:57:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:40 INFO - 'MOZ_NO_REMOTE': '1', 06:57:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:40 INFO - 'NO_EM_RESTART': '1', 06:57:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:40 INFO - 'PWD': '/builds/slave/test', 06:57:40 INFO - 'SHELL': '/bin/bash', 06:57:40 INFO - 'SHLVL': '1', 06:57:40 INFO - 'TERM': 'linux', 06:57:40 INFO - 'TMOUT': '86400', 06:57:40 INFO - 'USER': 'cltbld', 06:57:40 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:40 INFO - '_': '/tools/buildbot/bin/python'} 06:57:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:57:40 INFO - Running setup.py (path:/tmp/pip-SgRb6t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:57:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:57:40 INFO - Running setup.py (path:/tmp/pip-4mylKi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:57:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:57:40 INFO - Running setup.py (path:/tmp/pip-nMGJYM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:57:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:57:40 INFO - Running setup.py (path:/tmp/pip-YOs3fc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:57:41 INFO - Running setup.py (path:/tmp/pip-c5AHNZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:57:41 INFO - Running setup.py (path:/tmp/pip-ZDoOje-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:57:41 INFO - Running setup.py (path:/tmp/pip-gPJJJO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:57:41 INFO - Running setup.py (path:/tmp/pip-bQkWVl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:57:41 INFO - Running setup.py (path:/tmp/pip-19AkUq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:57:41 INFO - Running setup.py (path:/tmp/pip-lJWYgM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:57:41 INFO - Running setup.py (path:/tmp/pip-PMKaP3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:57:41 INFO - Running setup.py (path:/tmp/pip-W7lHxS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:57:41 INFO - Running setup.py (path:/tmp/pip-KSa4p4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:57:41 INFO - Running setup.py (path:/tmp/pip-Ov_pF_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:57:41 INFO - Running setup.py (path:/tmp/pip-8GSk2j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:57:41 INFO - Running setup.py (path:/tmp/pip-vir0wg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:57:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:57:41 INFO - Running setup.py (path:/tmp/pip-qTj0Kg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:57:41 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:57:41 INFO - Running setup.py install for manifestparser 06:57:42 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Running setup.py install for mozcrash 06:57:42 INFO - Running setup.py install for mozdebug 06:57:42 INFO - Running setup.py install for mozdevice 06:57:42 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Running setup.py install for mozfile 06:57:42 INFO - Running setup.py install for mozhttpd 06:57:42 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Running setup.py install for mozinfo 06:57:42 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Running setup.py install for mozInstall 06:57:42 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Running setup.py install for mozleak 06:57:42 INFO - Running setup.py install for mozlog 06:57:42 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:57:42 INFO - Running setup.py install for moznetwork 06:57:43 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:57:43 INFO - Running setup.py install for mozprocess 06:57:43 INFO - Running setup.py install for mozprofile 06:57:43 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:57:43 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:57:43 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:57:43 INFO - Running setup.py install for mozrunner 06:57:43 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:57:43 INFO - Running setup.py install for mozscreenshot 06:57:43 INFO - Running setup.py install for moztest 06:57:43 INFO - Running setup.py install for mozversion 06:57:43 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:57:43 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:57:43 INFO - Cleaning up... 06:57:43 INFO - Return code: 0 06:57:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:57:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:43 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 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:43 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 06:57:43 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 06:57:43 INFO - Using env: {'DISPLAY': ':0', 06:57:43 INFO - 'HOME': '/home/cltbld', 06:57:43 INFO - 'LANG': 'en_US.UTF-8', 06:57:43 INFO - 'LANGUAGE': 'en_US:en', 06:57:43 INFO - 'LOGNAME': 'cltbld', 06:57:43 INFO - 'MAIL': '/var/mail/cltbld', 06:57:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:43 INFO - 'MOZ_NO_REMOTE': '1', 06:57:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:43 INFO - 'NO_EM_RESTART': '1', 06:57:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:43 INFO - 'PWD': '/builds/slave/test', 06:57:43 INFO - 'SHELL': '/bin/bash', 06:57:43 INFO - 'SHLVL': '1', 06:57:43 INFO - 'TERM': 'linux', 06:57:43 INFO - 'TMOUT': '86400', 06:57:43 INFO - 'USER': 'cltbld', 06:57:43 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:43 INFO - '_': '/tools/buildbot/bin/python'} 06:57:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:57:43 INFO - Running setup.py (path:/tmp/pip-CtNj5F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:57:44 INFO - Running setup.py (path:/tmp/pip-g2fiVe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:57:44 INFO - Running setup.py (path:/tmp/pip-ilbqxu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:57:44 INFO - Running setup.py (path:/tmp/pip-IJuBeQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:57:44 INFO - Running setup.py (path:/tmp/pip-SJCcGD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:57:44 INFO - Running setup.py (path:/tmp/pip-pOU9_i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:57:44 INFO - Running setup.py (path:/tmp/pip-89_xeW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:57:44 INFO - Running setup.py (path:/tmp/pip-e6gcs2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:57:44 INFO - Running setup.py (path:/tmp/pip-o6eHIw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:57:44 INFO - Running setup.py (path:/tmp/pip-AotByu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:57:44 INFO - Running setup.py (path:/tmp/pip-MUOd7R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:57:44 INFO - Running setup.py (path:/tmp/pip-RMNuwJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:57:44 INFO - Running setup.py (path:/tmp/pip-CN2BL7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:57:44 INFO - Running setup.py (path:/tmp/pip-UjWwVj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:57:44 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)) 06:57:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:57:44 INFO - Running setup.py (path:/tmp/pip-oS0ZVr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:57:45 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)) 06:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:57:45 INFO - Running setup.py (path:/tmp/pip-IQF65_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:57:45 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)) 06:57:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:57:45 INFO - Running setup.py (path:/tmp/pip-oxXlAs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:57:45 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)) 06:57:45 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)) 06:57:45 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)) 06:57:45 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)) 06:57:45 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)) 06:57:45 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)) 06:57:45 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:57:45 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 06:57:45 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 06:57:45 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 06:57:45 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 06:57:45 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 06:57:45 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 06:57:47 INFO - Downloading blessings-1.6.tar.gz 06:57:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:57:47 INFO - Installing collected packages: blessings 06:57:47 INFO - Running setup.py install for blessings 06:57:47 INFO - Successfully installed blessings 06:57:47 INFO - Cleaning up... 06:57:47 INFO - Return code: 0 06:57:47 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:57:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:57:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:57:47 INFO - Reading from file tmpfile_stdout 06:57:47 INFO - Current package versions: 06:57:47 INFO - argparse == 1.2.1 06:57:47 INFO - blessings == 1.6 06:57:47 INFO - blobuploader == 1.2.4 06:57:47 INFO - docopt == 0.6.1 06:57:47 INFO - manifestparser == 1.1 06:57:47 INFO - mozInstall == 1.12 06:57:47 INFO - mozcrash == 0.17 06:57:47 INFO - mozdebug == 0.1 06:57:47 INFO - mozdevice == 0.48 06:57:47 INFO - mozfile == 1.2 06:57:47 INFO - mozhttpd == 0.7 06:57:47 INFO - mozinfo == 0.9 06:57:47 INFO - mozleak == 0.1 06:57:47 INFO - mozlog == 3.1 06:57:47 INFO - moznetwork == 0.27 06:57:47 INFO - mozprocess == 0.22 06:57:47 INFO - mozprofile == 0.28 06:57:47 INFO - mozrunner == 6.11 06:57:47 INFO - mozscreenshot == 0.1 06:57:47 INFO - mozsystemmonitor == 0.0 06:57:47 INFO - moztest == 0.7 06:57:47 INFO - mozversion == 1.4 06:57:47 INFO - psutil == 3.1.1 06:57:47 INFO - requests == 1.2.3 06:57:47 INFO - wsgiref == 0.1.2 06:57:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06: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')]} 06:57:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06: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')]} 06:57:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06: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/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 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:47 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 06:57:47 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 06:57:47 INFO - Using env: {'DISPLAY': ':0', 06:57:47 INFO - 'HOME': '/home/cltbld', 06:57:47 INFO - 'LANG': 'en_US.UTF-8', 06:57:47 INFO - 'LANGUAGE': 'en_US:en', 06:57:47 INFO - 'LOGNAME': 'cltbld', 06:57:47 INFO - 'MAIL': '/var/mail/cltbld', 06:57:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:47 INFO - 'MOZ_NO_REMOTE': '1', 06:57:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:47 INFO - 'NO_EM_RESTART': '1', 06:57:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:47 INFO - 'PWD': '/builds/slave/test', 06:57:47 INFO - 'SHELL': '/bin/bash', 06:57:47 INFO - 'SHLVL': '1', 06:57:47 INFO - 'TERM': 'linux', 06:57:47 INFO - 'TMOUT': '86400', 06:57:47 INFO - 'USER': 'cltbld', 06:57:47 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:47 INFO - '_': '/tools/buildbot/bin/python'} 06:57:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 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)) 06:57:47 INFO - Cleaning up... 06:57:47 INFO - Return code: 0 06:57:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06: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')]} 06:57:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06: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')]} 06:57:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:47 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 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:47 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 06:57:47 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 06:57:47 INFO - Using env: {'DISPLAY': ':0', 06:57:47 INFO - 'HOME': '/home/cltbld', 06:57:47 INFO - 'LANG': 'en_US.UTF-8', 06:57:47 INFO - 'LANGUAGE': 'en_US:en', 06:57:47 INFO - 'LOGNAME': 'cltbld', 06:57:47 INFO - 'MAIL': '/var/mail/cltbld', 06:57:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:47 INFO - 'MOZ_NO_REMOTE': '1', 06:57:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:47 INFO - 'NO_EM_RESTART': '1', 06:57:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:47 INFO - 'PWD': '/builds/slave/test', 06:57:47 INFO - 'SHELL': '/bin/bash', 06:57:47 INFO - 'SHLVL': '1', 06:57:47 INFO - 'TERM': 'linux', 06:57:47 INFO - 'TMOUT': '86400', 06:57:47 INFO - 'USER': 'cltbld', 06:57:47 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:47 INFO - '_': '/tools/buildbot/bin/python'} 06:57:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:47 INFO - Downloading/unpacking jsonschema 06:57:47 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 06:57:47 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 06:57:47 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 06:57:47 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 06:57:47 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 06:57:47 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 06:57:49 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:57:49 INFO - Downloading/unpacking functools32 (from jsonschema) 06:57:49 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 06:57:49 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 06:57:49 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 06:57:49 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 06:57:49 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 06:57:49 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 06:57:49 INFO - Downloading functools32-3.2.3-2.tar.gz 06:57:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:57:50 INFO - warning: no files found matching '*.txt' 06:57:50 INFO - no previously-included directories found matching 'build' 06:57:50 INFO - no previously-included directories found matching 'dist' 06:57:50 INFO - no previously-included directories found matching '.git*' 06:57:50 INFO - Installing collected packages: jsonschema, functools32 06:57:50 INFO - Running setup.py install for functools32 06:57:50 INFO - warning: no files found matching '*.txt' 06:57:50 INFO - no previously-included directories found matching 'build' 06:57:50 INFO - no previously-included directories found matching 'dist' 06:57:50 INFO - no previously-included directories found matching '.git*' 06:57:50 INFO - Successfully installed jsonschema functools32 06:57:50 INFO - Cleaning up... 06:57:50 INFO - Return code: 0 06:57:50 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 06:57:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:57:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:57:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:57:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:57:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe36f7e0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, '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': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', '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 06:57:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 06:57:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 06:57:50 INFO - Using env: {'DISPLAY': ':0', 06:57:50 INFO - 'HOME': '/home/cltbld', 06:57:50 INFO - 'LANG': 'en_US.UTF-8', 06:57:50 INFO - 'LANGUAGE': 'en_US:en', 06:57:50 INFO - 'LOGNAME': 'cltbld', 06:57:50 INFO - 'MAIL': '/var/mail/cltbld', 06:57:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:50 INFO - 'MOZ_NO_REMOTE': '1', 06:57:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:57:50 INFO - 'NO_EM_RESTART': '1', 06:57:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:57:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:50 INFO - 'PWD': '/builds/slave/test', 06:57:50 INFO - 'SHELL': '/bin/bash', 06:57:50 INFO - 'SHLVL': '1', 06:57:50 INFO - 'TERM': 'linux', 06:57:50 INFO - 'TMOUT': '86400', 06:57:50 INFO - 'USER': 'cltbld', 06:57:50 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:57:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:50 INFO - '_': '/tools/buildbot/bin/python'} 06:57:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:57:50 INFO - Downloading/unpacking flake8 06:57:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:57:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:57:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:57:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:57:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:57:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:57:52 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 06:57:52 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 06:57:52 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 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 06:57:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 06:57:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:57:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:57:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:57:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:57:53 INFO - no previously-included directories found matching 'docs/_build' 06:57:53 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 06:57:53 INFO - Running setup.py install for pep8 06:57:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:57:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:57:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:57:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:57:53 INFO - no previously-included directories found matching 'docs/_build' 06:57:53 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 06:57:53 INFO - Successfully installed flake8 mccabe pyflakes pep8 06:57:53 INFO - Cleaning up... 06:57:53 INFO - Return code: 0 06:57:53 INFO - Running post-action listener: _resource_record_post_action 06:57:53 INFO - Running post-action listener: _start_resource_monitoring 06:57:53 INFO - Starting resource monitoring. 06:57:53 INFO - ##### 06:57:53 INFO - ##### Running install step. 06:57:53 INFO - ##### 06:57:53 INFO - Running pre-action listener: _resource_record_pre_action 06:57:53 INFO - Running main action method: install 06:57:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:57:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:57:53 INFO - Reading from file tmpfile_stdout 06:57:53 INFO - Detecting whether we're running mozinstall >=1.0... 06:57:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:57:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:57:53 INFO - Reading from file tmpfile_stdout 06:57:53 INFO - Output received: 06:57:53 INFO - Usage: mozinstall [options] installer 06:57:53 INFO - Options: 06:57:53 INFO - -h, --help show this help message and exit 06:57:53 INFO - -d DEST, --destination=DEST 06:57:53 INFO - Directory to install application into. [default: 06:57:53 INFO - "/builds/slave/test"] 06:57:53 INFO - --app=APP Application being installed. [default: firefox] 06:57:53 INFO - mkdir: /builds/slave/test/build/application 06:57:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 06:57:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 06:58:09 INFO - Reading from file tmpfile_stdout 06:58:09 INFO - Output received: 06:58:09 INFO - /builds/slave/test/build/application/firefox/firefox 06:58:09 INFO - Running post-action listener: _resource_record_post_action 06:58:09 INFO - ##### 06:58:09 INFO - ##### Running run-tests step. 06:58:09 INFO - ##### 06:58:09 INFO - Running pre-action listener: _resource_record_pre_action 06:58:09 INFO - Running main action method: run_tests 06:58:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:58:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:58:09 INFO - Python 2.7.3 06:58:09 INFO - Return code: 0 06:58:09 INFO - grabbing minidump binary from tooltool 06:58:09 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')]} 06:58:09 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 0xf07160>, '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 0xf08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf084f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:58:09 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 06:58:09 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 06:58:09 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:58:09 INFO - Return code: 0 06:58:09 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 06:58:09 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:58:09 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:58:09 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 06:58:09 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:58:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 06:58:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 06:58:10 INFO - Return code: 0 06:58:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--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 06:58:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-013 --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 06:58:10 INFO - Using env: {'DISPLAY': ':0', 06:58:10 INFO - 'HOME': '/home/cltbld', 06:58:10 INFO - 'LANG': 'en_US.UTF-8', 06:58:10 INFO - 'LANGUAGE': 'en_US:en', 06:58:10 INFO - 'LOGNAME': 'cltbld', 06:58:10 INFO - 'MAIL': '/var/mail/cltbld', 06:58:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:58:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 06:58:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:58:10 INFO - 'MOZ_NO_REMOTE': '1', 06:58:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:58:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:58:10 INFO - 'NO_EM_RESTART': '1', 06:58:10 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:58:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:58:10 INFO - 'PWD': '/builds/slave/test', 06:58:10 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:58:10 INFO - 'SHELL': '/bin/bash', 06:58:10 INFO - 'SHLVL': '1', 06:58:10 INFO - 'TERM': 'linux', 06:58:10 INFO - 'TMOUT': '86400', 06:58:10 INFO - 'USER': 'cltbld', 06:58:10 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563', 06:58:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:58:10 INFO - '_': '/tools/buildbot/bin/python'} 06:58:10 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--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 06:58:10 INFO - mozversion application_buildid: 20160414033646 06:58:10 INFO - mozversion application_changeset: e4d417a8b34cc19ca33b030aa8eafb32a98d3bb7 06:58:10 INFO - mozversion application_display_name: FirefoxDeveloperEdition 06:58:10 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:58:10 INFO - mozversion application_name: Firefox 06:58:10 INFO - mozversion application_remotingname: firefox-dev 06:58:10 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:58:10 INFO - mozversion application_vendor: Mozilla 06:58:10 INFO - mozversion application_version: 47.0a2 06:58:10 INFO - mozversion platform_buildid: 20160414033646 06:58:10 INFO - mozversion platform_changeset: e4d417a8b34cc19ca33b030aa8eafb32a98d3bb7 06:58:10 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:58:10 INFO - mozversion platform_version: 47.0a2 06:58:10 INFO - using testdate: 1460642290 06:58:10 INFO - actual date: 1460642290 06:58:10 INFO - starting webserver on 'localhost:47565' 06:58:10 INFO - SUITE-START | Running 2 tests 06:58:10 INFO - TEST-START | dromaeo_css 06:58:10 INFO - operating with platform_type : linux_ 06:58:10 INFO - Initialising browser for dromaeo_css test... 06:58:10 INFO - TEST-INFO | started process 5969 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpc_Sh79/profile http://localhost:47565/getInfo.html) 06:58:13 INFO - PROCESS | 5969 | 06:58:13 INFO - PROCESS | 5969 | (process:6048): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 06:58:14 INFO - PROCESS | 5969 | __metrics Screen width/height:1600/1200 06:58:14 INFO - PROCESS | 5969 | colorDepth:24 06:58:14 INFO - PROCESS | 5969 | Browser inner width/height: 1024/697 06:58:14 INFO - PROCESS | 5969 | __metrics 06:58:15 ERROR - PROCESS | 5969 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 06:58:16 INFO - TEST-INFO | 5969: exit 0 06:58:16 INFO - Browser initialized. 06:58:16 INFO - Running cycle 1/1 for dromaeo_css test... 06:58:16 INFO - TEST-INFO | started process 6099 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpc_Sh79/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:58:18 INFO - PROCESS | 6099 | 06:58:18 INFO - PROCESS | 6099 | (process:6165): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 06:58:28 INFO - PROCESS | 6099 | RSS: Main: 151097344 06:58:28 INFO - PROCESS | 6099 | 06:59:17 INFO - PROCESS | 6099 | 1460642357829 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] 07:01:25 INFO - PROCESS | 6099 | Cycle 1(1): loaded http://localhost:47565/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47565/tests/dromaeo/cssquery-ext.html) 07:01:26 INFO - PROCESS | 6099 | RSS: Main: 155201536 07:01:26 INFO - PROCESS | 6099 | 07:04:28 INFO - PROCESS | 6099 | Cycle 1(1): loaded http://localhost:47565/tests/dromaeo/cssquery-ext.html (next: http://localhost:47565/tests/dromaeo/cssquery-jquery.html) 07:04:29 INFO - PROCESS | 6099 | RSS: Main: 153178112 07:04:29 INFO - PROCESS | 6099 | 07:07:31 INFO - PROCESS | 6099 | Cycle 1(1): loaded http://localhost:47565/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47565/tests/dromaeo/cssquery-mootools.html) 07:07:31 INFO - PROCESS | 6099 | RSS: Main: 153460736 07:07:31 INFO - PROCESS | 6099 | 07:10:33 INFO - PROCESS | 6099 | Cycle 1(1): loaded http://localhost:47565/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47565/tests/dromaeo/cssquery-prototype.html) 07:10:33 INFO - PROCESS | 6099 | RSS: Main: 152358912 07:10:33 INFO - PROCESS | 6099 | 07:13:36 INFO - PROCESS | 6099 | Cycle 1(1): loaded http://localhost:47565/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47565/tests/dromaeo/cssquery-yui.html) 07:13:36 INFO - PROCESS | 6099 | RSS: Main: 153780224 07:13:36 INFO - PROCESS | 6099 | 07:16:38 INFO - PROCESS | 6099 | Cycle 1(1): loaded http://localhost:47565/tests/dromaeo/cssquery-yui.html (next: http://localhost:47565/tests/dromaeo/cssquery-dojo.html) 07:16:39 INFO - PROCESS | 6099 | RSS: Main: 155246592 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - PROCESS | 6099 | __start_tp_report 07:16:39 INFO - PROCESS | 6099 | _x_x_mozilla_page_load 07:16:39 INFO - PROCESS | 6099 | _x_x_mozilla_page_load_details 07:16:39 INFO - PROCESS | 6099 | |i|pagename|runs| 07:16:39 INFO - PROCESS | 6099 | |0;dojo.html;3317.3862835375453;3373.814440205789;3401.6768407001327;3414.436617958037;3427.9657203427973;5554.1113421852515;5557.305336832896;5570.777168913243;5576.525995290405;5607.130894711316;5559.972200139004;5580.665160090397;5597.580181486394;5602.411746766592;5610.354809196943;5084.872878178047;5129.281900533928;5135.460776618457;5171.663841850286;5182.119039763231;4997.225430058329;5079.390473143209;5149.459306772791;5173.198154286091;5208.374995000605;5106.744662766865;5160.122779127557;5160.587153027749;5172.767225474844;5174.534291913727;5162.457941916101;5164.1995490699;5181.274621552967;5188.11801993662;5208.088584497736;4952.529509696573;4989.451160372356;5060.569851562622;5089.465606111342;5096.980603879239;5269.789208431658;5292.391374991887;5293.285406470154;5302.681839089667;5304.124819404794;5849.941500584982;5859;5880.059190529538;5882.6764527950945;5885.852853678693;5931.199288096095;5978.432048955342;6005.4895333896675;6046.727897244635;6053.334133245339;5627.6060675752715;5660.462256085665;5666.943330566683;5669.9433005669825;5676;5971.28344598651;6108.969455152695;6152.692365381802;6175.62946223228;6204.317525072239;5919.141724450017;5981.222441082718;5982.371850955674;5988.371221021817;5992.041273396236;6069.271687397452;6070.271567411939;6070.7875224366935;6072.878542429126;6075.1191077294425;5845.532357411397;5999.460048595647;6009.369016253318;6037.335893051761;6037.516998640098;6005.249343832021;6027.517798576191;6037.667928263988;6073.665948372882;6110.144579758838;4571.748553829505;4591.471980722193;4599.931001034987;4603.102395033004;4633.119707255611;4024.537178224483;4065.57311482296;4114.526829414655;4118.91762164761;4140.192662430857;5465.863353416196;5590.18942253371;5615.522680572197;5625.353084395265;5648.265725455664;6023.337432882379;6032.668203248776;6035.637861728223;6046.455818976226;6052.606580572248;5567.805126820542;5612.775488980476;5613.691246981455;5640.097584386561;5681.545476361881;5128.076946149728;5181.041507321158;5187.688738675692;5195.402528709171;5195.792168313225;6212.968935155295;6213.03697926822;6220.098085777537;6225;6230.6573138476915;5871.6770577618645;5934.910976335272;5970;5983.192269043798;5996.130561068708;6186.319504854552;6219.626822390671;6231.719572619152;6254.3745625437095;6275.843103922439;5752.28096487939;5958.910616340671;5981.9401805983125;5998.077028460983;6022.45797878193;5980.760769569342;6036.8188954331445;6039.758409663565;6050.273967123973;6068.666223357758;5826.679532625577;5873.5594830388745;5875.148103525051;5892.616979896293;5905.675187864536;5709.885802283848;5848;5866.794662186803;5889.764409423575;5908.497777688945;5778.739956702043;5794.797182098607;5803.274590676166;5835.503982161564;5861.9706901465215;5904.911426328523;5905.911411328748;5910.054391297372;5938.61399009063;5952;5579.386267510652;5695.658260504383;5712.200291959212;5795.94204057954;5838.737256823538 07:16:39 INFO - PROCESS | 6099 | |1;ext.html;536.5010540197615;549.7333793110341;554.1798138754641;579.168892639063;597.3250227243215;31247.843760781194;40293.19413611726;40632.59367406325;40897.79551102241;40912.59087409132;43484;44111.77944110283;44268;44357.77821110898;44473.77763111188;8828.161324674162;8989.865152022725;8990.10098990099;8994;9039.367244292902;8778.429402088876;8863.822723545525;8873.778155546132;8885.511296878669;9109.863352049724;9059.909400905972;9132.041135680724;9155.862662060075;9187.95406022969;9223.308251881102;9047.366684332099;9117.270618350516;9130.086991300883;9130.771730706752;9137.908620913773;9071.274298056205;9139.314551408672;9210.263178945668;9238.891333040012;9255.398399104037;41351.7932410336;41827.372589411185;41839.58160418387;41859.79070104661;41955.53155639538;3705.073731567108;3771.981140094282;3915;4361.781910904442;4428.136513379892;33138.83430582831;33430;33514;33713.49429758556;33751;4097.344424892033;4133.751974881517;4141.109661422808;4150.149219410014;4161.812718427678;297616;298006;300260;301166;301920;45921;46434.535654643696;67091;67276;67402.32597674058;44758.10483790306;44766.10467790626;44844.32733509;44958.55041449544;45246.77376613096;13445.260510672008;13521.526746564019;13539.729205416033;13628.591142265748;13636.181829090287;11442.771144577062;11474.967252947275;11487.597934072268;11504;11533.88466115328;15186.772198417033;15653.139077350626;15725.528234152993;15826.208689565476;15953.564179223926;5985.581009329305;6001.489873360813;6005.759769609167;6054.3945605439985;6110.816675499742;1027.306568066552;1052.4474650808386;1067.1782727299935;1112.7551938573502;1143.89704926557;30280.697193028227;30828.38343233123;30950;31142.532862007087;31336.05991820249;1048.8374301983206;1111.372074777748;1205.391277404905;1205.6081773423673;1226.576830993306;15877.603059923364;16015.359385624677;16157.120646920535;16188.838111618968;16236.85960080172;356418;468619;532076;534890;534934;58275.12587311194;58607.70696146492;59168;59299.70350148222;59533.40466595279;1450.760624496946;1468.383279022813;1473.9263036848329;1480.104536755269;1507.4121092773607;30051.398972020874;31559.89540366076;33264;33307.33385332328;33365;52874;53208.467915320354;53294.200586992;53393;53598.73200633972;316041;320110;320196;320411;321383;36310.27379452449;36480.63519364772;36876.631233687316;36971.26057478889;37282.44076338912;49433.258501121796;50429.74785126198;50629.49370506248;50721.49278507168;51021.7448912753;40191.397129043675;41312.1737565253;42494.575054249064;43085.3537196936;43253;41235.793821030704;41945.58054419417;42031;42085.78957105195;42205;40259;40718;41185.1762964745;41238.79380603198;41397.37903931383;36164.819175903955;36320;37225.627743722216;37276.25447491089;37848.62151378451;27615.447691045665;27732.168034958984;27809.721902781523;27894.721052789213;28064.43871122607 07:16:39 INFO - PROCESS | 6099 | |2;jquery.html;377.04419297081887;381.7213434193038;389.33229511387964;389.9785511796851;397.0906623831426;17515.386961456352;18221.817781822177;18751.249950001984;18752.812471875277;18831.529211769714;11921.761564768722;12354.196977196498;12366.752664946696;12398.81401778974;12406.937965310184;5156.974215128919;5296.867578310535;5399.595030372718;5585.162225666162;5724.656520608777;5497.945020549803;5501.752421141038;5551.694656793875;5554.666719996793;5579.581531385142;5438.646487978289;5540.778368865241;5813.157092221625;5846.50304724099;5874.794382196624;5773.740181691834;5776.797812076578;5789.710514474302;5791.884162316751;5796.13058041293;5578.9163162552595;5579.8884022319735;5720;5722.284714410699;5739.311282646067;14377.065490743069;14420.42318307277;16599;20461.590768184553;20839.062242199136;2268;2354.281944007077;2511.0583531175807;2895.4498645257336;2991.8055326403714;9893.901060989441;10014.098731114234;10313.89686103137;10389.480525973746;10429.21780866438;1964.037621565437;1971.5169783403157;2031.2788959919312;2055.2601063617085;2071.2439959414855;64232;65429;66883.3311666882;67054;68811.65594171998;10365.9481702591;10558.736031599117;10662.573497060186;10716.78566428667;10719.19606029551;14880.255987200813;15134.243287835565;15144.772828407582;15179.392824286904;15194.468193613171;7562.130355009244;7630.8092297693;7645.847083058307;7740.303372696484;7941.841163176704;7159.637319684492;7218.242084581043;7426.814329641694;7432.9256707433315;7534.321911028033;4267.3598960155605;4332.761698106571;4572.0855828834365;4600.700954438018;4710.858674239778;1919.9520011999812;1959.2456904092028;1970.5172232803054;2037.2869495676691;2037.6637854753799;1072.1101485766794;1089.1178145702006;1107.9335239885634;1142.274655593704;1153.4578747988432;17059.65880682404;17822.198001089724;17887.10564471771;18137.909310453364;18341.7248741269;983.3755565216139;1011.3173607814696;1020.7346090016649;1032.865727455426;1103.448275862069;10073;10420.791584168273;10484.895151048544;10528.205716451648;10704.839427408595;441464;447187;451713;452914;453498;80706;81978;82272.17727822645;82370;83128.58435707782;1076.531708706715;1079.3577821196375;1088.9019988200941;1097.6103483263325;1106.4246591772232;16324.67350653004;16354.67290654204;16502;16503.17484125813;16726.414575489798;34006.319873602886;34646.480302794975;35620.82189589139;35698;36471.08822279464;50038.74980625074;50827;51442;51445.48554514407;51585.22622160746;8802.647894084164;8872.467651940904;8878.911210887809;8935.146840167372;9078.500682462529;12563.623091307276;12878.871211287767;13061;13086.80369794473;13119.606411807279;10673.89326106729;10760.19298552596;10813.405262710627;10931.39877306724;11315.603953861575;11754;11827.112966527373;11971.700707482383;11977.401129943642;12218.26690398579;10823.134149268197;11025.503852326825;11057.336559806437;11098.5560577576;11250.887491124984;8791.868121978303;8810.779730506532;8873.64505419776;8942.597583108645;9064.728058158265;10886.23796334249;11020.834687479533;11149.665510034712;11196.328220306808;11218.775624487627 07:16:39 INFO - PROCESS | 6099 | |3;mootools.html;1531.747261701819;1545.4977132431961;1800.4418630224632;1908.6755251607226;1927.6433859735941;7075.327843854839;7915.722949696762;8017.238362355574;8272.296854767344;8310.750677479678;8253.793655158624;8312.376571757111;8428.283595894356;8463.111373305806;8463.957680211606;2291.9083236670513;2305.6310990241564;2307.9423014424688;2310.919117830876;2319.1651005637955;2295.036084844361;2310.526342099874;2367.479154585997;2372.9914786215877;2381.6070348392495;2302.689136966513;2302.9884850575722;2309.2725791375747;2319.199876042771;2325.476767727265;2258.322503249027;2284.942876428086;2285.0973865323103;2296.0471404367336;2310.0528783198806;2298.1152256381247;2310.560993411263;2313.9305820825402;2317.6523521471745;2319.652052192168;8340.624671889718;8391.160883911622;8408.789780255542;8410.495370277742;8413;4997.925031124536;5071.619628527875;5087.160618497944;5094.949050509485;5104.489551044866;3106.6582675905634;3194.5847039884898;3241.286916878283;3246.107320486861;3261.624913134996;1073.457903758597;1079.7786453777035;1094.9616763413321;1099.5656715597295;1105.922585419021;11264.831027534512;11351.886481135249;11353.20527563071;11353.545858165664;11357.886421135765;4213.536510983789;4391.385206071152;4426.3581780641625;4444.044530425974;4452.042810795694;9637.22902167825;9694.466804325688;9720.416774993522;9722.465264410524;9754;5056;5079.923801142986;5104.515071068243;5125.231215317732;5128.153854613947;4097.405876147942;4522.977385113053;4599.885002874955;4650.813967441264;4686.039361930796;3797.6771974382486;3842.2507611015585;3871.109644781716;3874.9612503875164;3924.9215015699524;1215.1858254969193;1217.6225370135287;1219.5000049979467;1235.4625737804083;1248.9875101249054;1081.4971038466992;1095.802755504017;1099.9175061870392;1264.9620511384674;1357.911735737174;7394.371478424394;7418.591977441185;7438.814029649302;7441.330280274801;7889.21107889218;448.5111228760667;449.63804137668836;449.768369289816;450.58321053026475;478.2228878073131;5771.740271687784;5780.1907732917425;5789.826305210766;5818.854528636818;5863.237779088691;9593.952030239805;9727.756806079904;9730.805383892282;9776.902230977741;9819.852702209473;9628.90371096294;9631.422114673142;9698.806023879624;9704.078112579293;9713.70858874235;7508.699652013858;7697.730579429693;7766.611669416507;7784.065912090586;7853.842923141505;7524.548527088392;7650.349720273839;7667.578283194478;7677.117131529722;7691.50005249657;8514.659413623385;9009.63961441535;9095.772605684911;9133.132352426508;9140;8752.037275899773;8919.241864441596;8926.285897128084;8966.551672416223;8991.820163596822;7029.332213439715;7183.748568800067;7193.928060719326;7206.531575447579;7310.232425595449;7739.535627862347;7755.573443460664;7765.107012693613;7772.844543108993;7784.610769461391;6892.104026476526;6915.619640919797;6958.478114141359;7033.0856988593205;7050.189228238818;6863.519553631198;6865.794026179223;6924.826879328057;6960.408365288805;6995.370416662525;7278.854422911406;7344.41244700412;7381.11426628808;7493.288137626917;7552.244775522404;6846.691898864464;6854.657267136723;6860.142482189726;6870.27862074475;6890.31096890307;6947.478939079489;7005.299470052954;7020.613866237406;7065.6113913735235;7067.081279433641 07:16:39 INFO - PROCESS | 6099 | |4;prototype.html;354.36214813336;354.94320908654606;358.04402246003167;364.1497104261549;373.3224198080484;6390.616563006223;6421.807345779628;6453.83865403364;6455.193100862392;6467.805965821021;6371.617702937815;6377.139086223358;6388.776392826252;6398.4561312288515;6401.263854656716;4721.268203428474;4743.075100355432;4803.3995750531185;4812.663113582051;4899.853004409864;4825.662203645747;4854.587360074398;4858.708477491344;4867.415910090776;4868.537488938545;4785.545373189559;4804.8078076877055;4810.975945120287;4813.7593120343845;4823.493533179018;4783.665143439978;4822.565969062784;4832.033593281322;4836.37127173467;4842.927356089662;4158.064435501988;4184.979075104605;4189.162167566468;4192.24539582875;4199.958000419987;5948.910766338508;6098;6101.115338275969;6105.725242364104;6112.480439162632;5671.716414179275;5677.460641239076;5680.233168522238;5684.317881854204;5704.087346024658;6711.899321510181;6732.360425759545;6736.427403670694;6746.257911629717;6747.93252067478;4699.553542413465;4707.223308154151;4712.740799256039;4717.481077081518;4722.504137065627;7035.92964070363;7111.288871112847;7115.1106111736035;7118.92881071193;7124.608146551937;4731.384919960383;4806.711597304173;4831.758412079382;4844.15227335215;4856.635752318591;4900.485449027872;4913.582345500672;4929.433115191727;4935.506449355035;4935.950640493621;5654.236678048493;5667.603267771299;5673.489385955201;5675.290588676416;5695.373508914016;6824.829379265558;6825.897611535831;6830.692618832164;6836.350546698056;6837.726490940307;1715.1167148918316;1744.1715185287142;1745.2669878650997;1745.4763570928671;1745.6945034619146;1110.1008183371496;1119.5130118398522;1139.925904816201;1146.954121835134;1160.048760016778;6550.115734375799;6565.048068030204;6568.80293591193;6582.341765823379;6591.406773390322;7022;7073.92926070743;7096.254893236136;7097.361237488651;7104.396126329217;6374.649394283266;6474.546781725234;6488.513361497812;6608;6705.731770729214;3818.2554401891366;3831.9616803832164;3853.5761066282685;3868.477755502971;3869.0134015825784;7333.339999399973;7366.079240094989;7366.668499917517;7375.483716139819;7440.10718713747;7213.206547279795;7253.455990800711;7262.055932728711;7289;7292.598907060056;7131.82170445743;7400.111986561539;7409.481336306515;7439.85120297591;7440.85118297631;7074.575525468488;7097.82255443618;7144.071270734979;7162.928370716226;7183.604901730246;6996.650167491707;7038.225795162426;7084.433245340463;7094.893576596252;7101.183363913009;7371.3734332582335;7391.556506609621;7406.481546291708;7406.925930740624;7407.888881666671;4720.905581888412;4819.927701084416;4859.246816743411;4862.246351815475;4875.1224779540025;7040.753573624898;7066.364027237573;7114.14630244374;7122.786316410516;7129.607871567114;6827.829304267433;6908.860038093659;6909.550879192836;6917.342852429011;7001.36987671112;6838.487113466609;6889.104416425833;6900.896486552605;6904.3095690430555;6911.101556797786;6614.636195009129;6708.798736037927;6725.495587830835;6731.057651928636;6753.594784312957;6879.174499060145;6897.3447522485285;6900.413464855544;6913.965430172817;6918.169819621678;6716.227633821977;6724.226713927961;6742.056112144206;6746.966265168643;6776.356246156607 07:16:39 INFO - PROCESS | 6099 | |5;yui.html;805.0621026504122;829.1584042197168;860.8407444622742;871.4117970369998;887.9378443508955;13594;13730.038897277194;13755.174689518635;13849.515266965658;13914.30428478577;12962.546310879121;13039.73920521589;13088.73822523549;13128.868711312884;13150.342482875865;762.5119923249125;889.4840992224495;897.2687259883174;899.1772528136747;912.7170577121113;904.4799240436743;904.8643951840431;906.2342320738998;907.9001309855911;912.9406588571721;964.3105179796444;965.884093908732;967.5307475874196;968.2979839616293;970.2335155227362;950.2255661635745;955.4267439536292;958.228625956105;960.2558017536395;962.2157941277871;707.7770502291762;709.1986055757013;711.9323664251888;712.672170801432;712.704227745485;13879.444822207099;13973.650658733613;14005.579832605039;14011.579652610439;14015;12187.878121218762;13127.540536081191;13253.204807711472;13365.799513007312;13454.730905381935;10383;12166.81749773754;12637.178583392142;12656.114072014963;12913.289769062698;3477.4088404971217;3554.0937061049526;3570.696490798285;3573.9992802015217;3592.7305452091196;52673.47326526724;53218.201726974126;53341;53824.19263711048;54179.72910135503;11029.724256893642;11438.370889600985;11483.885161148448;11494.54021839117;11656.825147622792;20114.094865731076;20298.797012029692;20301.492462688257;20325.89837050835;20372.28696995598;7046.43628509718;7063.646817659096;8019.879701804478;8030.39772017101;8202.507849529047;4059.9594004060173;4112.650424713933;4336;4362.847300344472;4362.956370436318;3370.224848284859;3380.3746306932803;3385.069105995871;3391.576052993376;3409.113630456099;615.350804900834;622.9190205273286;623.2458724942779;626.139058794158;633.7021599848064;665.6272487407067;737.7602279259155;755.4485225785207;763.713607397226;792.3977776889606;7967.28294453502;8157.918420815716;8293.170682931659;8430;8448.788780280542;653.4935425045628;744.4156337275213;745.4781652843031;754.3701009656888;754.4567911103996;3714.851405943786;3773.509443772347;3777.150141218259;3871.457995880579;3873.2059927715313;56941;59200;59755;59881.401185988456;59995.40004599986;51170.48829511657;51724;51748.48251517512;51962.740186298826;52022.47977520252;47481.76259118682;48140.27789583159;48359.75820120947;48760.02479950452;48790.75604622025;7621.31408173267;7675.769726908202;8618;9304.627814887328;9317;34716;35286.29427411386;37147.25705485929;37854.81072594619;38262;45882;46073.53926460692;47020.529794701615;47269;47848;12080.536912751691;12137.757244855231;12173.087018473827;12237.265764054186;12342.44458999365;11277.830832537355;13132;13186.472541098248;13890.374933127832;14205.786913196516;11879.346635935106;12113.75772484563;12413.503459861504;13107.951363891056;13306.46774129024;11627.12796540246;11633.941830290794;11722.120840937134;11745.29528228309;12884.162529435556;11920;12337.444814983526;12399.25604463735;12450.688732781753;12616;10099.44453055089;10199.898001019896;10237.334573252714;10781.245312828027;10851.782964340511;10943.507542160782;11030.834537481784;11159.72100697489;11173.832392513956;11242.943785281348 07:16:39 INFO - PROCESS | 6099 | __end_tp_report 07:16:39 INFO - PROCESS | 6099 | __start_cc_report 07:16:39 INFO - PROCESS | 6099 | _x_x_mozilla_cycle_collect,331 07:16:39 INFO - PROCESS | 6099 | __end_cc_report 07:16:39 INFO - PROCESS | 6099 | __startTimestamp1460643399192__endTimestamp 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - PROCESS | 6099 | ------- Summary: start ------- 07:16:39 INFO - PROCESS | 6099 | Number of tests: 6 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - PROCESS | 6099 | [#0] dojo.html Cycles:165 Average:5572.77 Median:5795.94 stddev:618.59 (10.7%) stddev-sans-first:594.65 07:16:39 INFO - PROCESS | 6099 | Values: 3317.4 3373.8 3401.7 3414.4 3428.0 5554.1 5557.3 5570.8 5576.5 5607.1 5560.0 5580.7 5597.6 5602.4 5610.4 5084.9 5129.3 5135.5 5171.7 5182.1 4997.2 5079.4 5149.5 5173.2 5208.4 5106.7 5160.1 5160.6 5172.8 5174.5 5162.5 5164.2 5181.3 5188.1 5208.1 4952.5 4989.5 5060.6 5089.5 5097.0 5269.8 5292.4 5293.3 5302.7 5304.1 5849.9 5859.0 5880.1 5882.7 5885.9 5931.2 5978.4 6005.5 6046.7 6053.3 5627.6 5660.5 5666.9 5669.9 5676.0 5971.3 6109.0 6152.7 6175.6 6204.3 5919.1 5981.2 5982.4 5988.4 5992.0 6069.3 6070.3 6070.8 6072.9 6075.1 5845.5 5999.5 6009.4 6037.3 6037.5 6005.2 6027.5 6037.7 6073.7 6110.1 4571.7 4591.5 4599.9 4603.1 4633.1 4024.5 4065.6 4114.5 4118.9 4140.2 5465.9 5590.2 5615.5 5625.4 5648.3 6023.3 6032.7 6035.6 6046.5 6052.6 5567.8 5612.8 5613.7 5640.1 5681.5 5128.1 5181.0 5187.7 5195.4 5195.8 6213.0 6213.0 6220.1 6225.0 6230.7 5871.7 5934.9 5970.0 5983.2 5996.1 6186.3 6219.6 6231.7 6254.4 6275.8 5752.3 5958.9 5981.9 5998.1 6022.5 5980.8 6036.8 6039.8 6050.3 6068.7 5826.7 5873.6 5875.1 5892.6 5905.7 5709.9 5848.0 5866.8 5889.8 5908.5 5778.7 5794.8 5803.3 5835.5 5862.0 5904.9 5905.9 5910.1 5938.6 5952.0 5579.4 5695.7 5712.2 5795.9 5838.7 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - PROCESS | 6099 | [#1] ext.html Cycles:180 Average:53882.99 Median:41275.48 stddev:100378.01 (243.2%) stddev-sans-first:100579.68 07:16:39 INFO - PROCESS | 6099 | Values: 536.5 549.7 554.2 579.2 597.3 31247.8 40293.2 40632.6 40897.8 40912.6 43484.0 44111.8 44268.0 44357.8 44473.8 8828.2 8989.9 8990.1 8994.0 9039.4 8778.4 8863.8 8873.8 8885.5 9109.9 9059.9 9132.0 9155.9 9188.0 9223.3 9047.4 9117.3 9130.1 9130.8 9137.9 9071.3 9139.3 9210.3 9238.9 9255.4 41351.8 41827.4 41839.6 41859.8 41955.5 3705.1 3772.0 3915.0 4361.8 4428.1 33138.8 33430.0 33514.0 33713.5 33751.0 4097.3 4133.8 4141.1 4150.1 4161.8 297616.0 298006.0 300260.0 301166.0 301920.0 45921.0 46434.5 67091.0 67276.0 67402.3 44758.1 44766.1 44844.3 44958.6 45246.8 13445.3 13521.5 13539.7 13628.6 13636.2 11442.8 11475.0 11487.6 11504.0 11533.9 15186.8 15653.1 15725.5 15826.2 15953.6 5985.6 6001.5 6005.8 6054.4 6110.8 1027.3 1052.4 1067.2 1112.8 1143.9 30280.7 30828.4 30950.0 31142.5 31336.1 1048.8 1111.4 1205.4 1205.6 1226.6 15877.6 16015.4 16157.1 16188.8 16236.9 356418.0 468619.0 532076.0 534890.0 534934.0 58275.1 58607.7 59168.0 59299.7 59533.4 1450.8 1468.4 1473.9 1480.1 1507.4 30051.4 31559.9 33264.0 33307.3 33365.0 52874.0 53208.5 53294.2 53393.0 53598.7 316041.0 320110.0 320196.0 320411.0 321383.0 36310.3 36480.6 36876.6 36971.3 37282.4 49433.3 50429.7 50629.5 50721.5 51021.7 40191.4 41312.2 42494.6 43085.4 43253.0 41235.8 41945.6 42031.0 42085.8 42205.0 40259.0 40718.0 41185.2 41238.8 41397.4 36164.8 36320.0 37225.6 37276.3 37848.6 27615.4 27732.2 27809.7 27894.7 28064.4 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - PROCESS | 6099 | [#2] jquery.html Cycles:180 Average:26296.60 Median:2063.25 stddev:73831.59 (3578.4%) stddev-sans-first:74013.06 07:16:39 INFO - PROCESS | 6099 | Values: 377.0 381.7 389.3 390.0 397.1 17515.4 18221.8 18751.2 18752.8 18831.5 11921.8 12354.2 12366.8 12398.8 12406.9 5157.0 5296.9 5399.6 5585.2 5724.7 5497.9 5501.8 5551.7 5554.7 5579.6 5438.6 5540.8 5813.2 5846.5 5874.8 5773.7 5776.8 5789.7 5791.9 5796.1 5578.9 5579.9 5720.0 5722.3 5739.3 14377.1 14420.4 16599.0 20461.6 20839.1 2268.0 2354.3 2511.1 2895.4 2991.8 9893.9 10014.1 10313.9 10389.5 10429.2 1964.0 1971.5 2031.3 2055.3 2071.2 64232.0 65429.0 66883.3 67054.0 68811.7 10365.9 10558.7 10662.6 10716.8 10719.2 14880.3 15134.2 15144.8 15179.4 15194.5 7562.1 7630.8 7645.8 7740.3 7941.8 7159.6 7218.2 7426.8 7432.9 7534.3 4267.4 4332.8 4572.1 4600.7 4710.9 1920.0 1959.2 1970.5 2037.3 2037.7 1072.1 1089.1 1107.9 1142.3 1153.5 17059.7 17822.2 17887.1 18137.9 18341.7 983.4 1011.3 1020.7 1032.9 1103.4 10073.0 10420.8 10484.9 10528.2 10704.8 441464.0 447187.0 451713.0 452914.0 453498.0 80706.0 81978.0 82272.2 82370.0 83128.6 1076.5 1079.4 1088.9 1097.6 1106.4 16324.7 16354.7 16502.0 16503.2 16726.4 34006.3 34646.5 35620.8 35698.0 36471.1 50038.7 50827.0 51442.0 51445.5 51585.2 8802.6 8872.5 8878.9 8935.1 9078.5 12563.6 12878.9 13061.0 13086.8 13119.6 10673.9 10760.2 10813.4 10931.4 11315.6 11754.0 11827.1 11971.7 11977.4 12218.3 10823.1 11025.5 11057.3 11098.6 11250.9 8791.9 8810.8 8873.6 8942.6 9064.7 10886.2 11020.8 11149.7 11196.3 11218.8 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - PROCESS | 6099 | [#3] mootools.html Cycles:180 Average:5701.46 Median:6850.67 stddev:3004.75 (43.9%) stddev-sans-first:2996.83 07:16:39 INFO - PROCESS | 6099 | Values: 1531.7 1545.5 1800.4 1908.7 1927.6 7075.3 7915.7 8017.2 8272.3 8310.8 8253.8 8312.4 8428.3 8463.1 8464.0 2291.9 2305.6 2307.9 2310.9 2319.2 2295.0 2310.5 2367.5 2373.0 2381.6 2302.7 2303.0 2309.3 2319.2 2325.5 2258.3 2284.9 2285.1 2296.0 2310.1 2298.1 2310.6 2313.9 2317.7 2319.7 8340.6 8391.2 8408.8 8410.5 8413.0 4997.9 5071.6 5087.2 5094.9 5104.5 3106.7 3194.6 3241.3 3246.1 3261.6 1073.5 1079.8 1095.0 1099.6 1105.9 11264.8 11351.9 11353.2 11353.5 11357.9 4213.5 4391.4 4426.4 4444.0 4452.0 9637.2 9694.5 9720.4 9722.5 9754.0 5056.0 5079.9 5104.5 5125.2 5128.2 4097.4 4523.0 4599.9 4650.8 4686.0 3797.7 3842.3 3871.1 3875.0 3924.9 1215.2 1217.6 1219.5 1235.5 1249.0 1081.5 1095.8 1099.9 1265.0 1357.9 7394.4 7418.6 7438.8 7441.3 7889.2 448.5 449.6 449.8 450.6 478.2 5771.7 5780.2 5789.8 5818.9 5863.2 9594.0 9727.8 9730.8 9776.9 9819.9 9628.9 9631.4 9698.8 9704.1 9713.7 7508.7 7697.7 7766.6 7784.1 7853.8 7524.5 7650.3 7667.6 7677.1 7691.5 8514.7 9009.6 9095.8 9133.1 9140.0 8752.0 8919.2 8926.3 8966.6 8991.8 7029.3 7183.7 7193.9 7206.5 7310.2 7739.5 7755.6 7765.1 7772.8 7784.6 6892.1 6915.6 6958.5 7033.1 7050.2 6863.5 6865.8 6924.8 6960.4 6995.4 7278.9 7344.4 7381.1 7493.3 7552.2 6846.7 6854.7 6860.1 6870.3 6890.3 6947.5 7005.3 7020.6 7065.6 7067.1 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - PROCESS | 6099 | [#4] prototype.html Cycles:180 Average:5715.89 Median:6471.18 stddev:1745.14 (27.0%) stddev-sans-first:1703.00 07:16:39 INFO - PROCESS | 6099 | Values: 354.4 354.9 358.0 364.1 373.3 6390.6 6421.8 6453.8 6455.2 6467.8 6371.6 6377.1 6388.8 6398.5 6401.3 4721.3 4743.1 4803.4 4812.7 4899.9 4825.7 4854.6 4858.7 4867.4 4868.5 4785.5 4804.8 4811.0 4813.8 4823.5 4783.7 4822.6 4832.0 4836.4 4842.9 4158.1 4185.0 4189.2 4192.2 4200.0 5948.9 6098.0 6101.1 6105.7 6112.5 5671.7 5677.5 5680.2 5684.3 5704.1 6711.9 6732.4 6736.4 6746.3 6747.9 4699.6 4707.2 4712.7 4717.5 4722.5 7035.9 7111.3 7115.1 7118.9 7124.6 4731.4 4806.7 4831.8 4844.2 4856.6 4900.5 4913.6 4929.4 4935.5 4936.0 5654.2 5667.6 5673.5 5675.3 5695.4 6824.8 6825.9 6830.7 6836.4 6837.7 1715.1 1744.2 1745.3 1745.5 1745.7 1110.1 1119.5 1139.9 1147.0 1160.0 6550.1 6565.0 6568.8 6582.3 6591.4 7022.0 7073.9 7096.3 7097.4 7104.4 6374.6 6474.5 6488.5 6608.0 6705.7 3818.3 3832.0 3853.6 3868.5 3869.0 7333.3 7366.1 7366.7 7375.5 7440.1 7213.2 7253.5 7262.1 7289.0 7292.6 7131.8 7400.1 7409.5 7439.9 7440.9 7074.6 7097.8 7144.1 7162.9 7183.6 6996.7 7038.2 7084.4 7094.9 7101.2 7371.4 7391.6 7406.5 7406.9 7407.9 4720.9 4819.9 4859.2 4862.2 4875.1 7040.8 7066.4 7114.1 7122.8 7129.6 6827.8 6908.9 6909.6 6917.3 7001.4 6838.5 6889.1 6900.9 6904.3 6911.1 6614.6 6708.8 6725.5 6731.1 6753.6 6879.2 6897.3 6900.4 6914.0 6918.2 6716.2 6724.2 6742.1 6747.0 6776.4 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - PROCESS | 6099 | [#5] yui.html Cycles:180 Average:14565.53 Median:4086.30 stddev:16675.97 (408.1%) stddev-sans-first:16690.74 07:16:39 INFO - PROCESS | 6099 | Values: 805.1 829.2 860.8 871.4 887.9 13594.0 13730.0 13755.2 13849.5 13914.3 12962.5 13039.7 13088.7 13128.9 13150.3 762.5 889.5 897.3 899.2 912.7 904.5 904.9 906.2 907.9 912.9 964.3 965.9 967.5 968.3 970.2 950.2 955.4 958.2 960.3 962.2 707.8 709.2 711.9 712.7 712.7 13879.4 13973.7 14005.6 14011.6 14015.0 12187.9 13127.5 13253.2 13365.8 13454.7 10383.0 12166.8 12637.2 12656.1 12913.3 3477.4 3554.1 3570.7 3574.0 3592.7 52673.5 53218.2 53341.0 53824.2 54179.7 11029.7 11438.4 11483.9 11494.5 11656.8 20114.1 20298.8 20301.5 20325.9 20372.3 7046.4 7063.6 8019.9 8030.4 8202.5 4060.0 4112.7 4336.0 4362.8 4363.0 3370.2 3380.4 3385.1 3391.6 3409.1 615.4 622.9 623.2 626.1 633.7 665.6 737.8 755.4 763.7 792.4 7967.3 8157.9 8293.2 8430.0 8448.8 653.5 744.4 745.5 754.4 754.5 3714.9 3773.5 3777.2 3871.5 3873.2 56941.0 59200.0 59755.0 59881.4 59995.4 51170.5 51724.0 51748.5 51962.7 52022.5 47481.8 48140.3 48359.8 48760.0 48790.8 7621.3 7675.8 8618.0 9304.6 9317.0 34716.0 35286.3 37147.3 37854.8 38262.0 45882.0 46073.5 47020.5 47269.0 47848.0 12080.5 12137.8 12173.1 12237.3 12342.4 11277.8 13132.0 13186.5 13890.4 14205.8 11879.3 12113.8 12413.5 13108.0 13306.5 11627.1 11633.9 11722.1 11745.3 12884.2 11920.0 12337.4 12399.3 12450.7 12616.0 10099.4 10199.9 10237.3 10781.2 10851.8 10943.5 11030.8 11159.7 11173.8 11242.9 07:16:39 INFO - PROCESS | 6099 | -------- Summary: end -------- 07:16:39 INFO - PROCESS | 6099 | 07:16:39 INFO - TEST-INFO | 6099: exit 0 07:16:39 INFO - TEST-OK | dromaeo_css | took 1109570ms 07:16:39 INFO - TEST-START | kraken 07:16:39 INFO - operating with platform_type : linux_ 07:16:39 INFO - Initialising browser for kraken test... 07:16:39 INFO - TEST-INFO | started process 6342 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2VcndH/profile http://localhost:47565/getInfo.html) 07:16:43 INFO - PROCESS | 6342 | 07:16:43 INFO - PROCESS | 6342 | (process:6418): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:16:44 INFO - PROCESS | 6342 | __metrics Screen width/height:1600/1200 07:16:44 INFO - PROCESS | 6342 | colorDepth:24 07:16:44 INFO - PROCESS | 6342 | Browser inner width/height: 1024/697 07:16:44 INFO - PROCESS | 6342 | __metrics 07:16:45 ERROR - PROCESS | 6342 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 07:16:46 INFO - TEST-INFO | 6342: exit 0 07:16:46 INFO - Browser initialized. 07:16:46 INFO - Running cycle 1/1 for kraken test... 07:16:46 INFO - TEST-INFO | started process 6469 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2VcndH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:16:47 INFO - PROCESS | 6469 | 07:16:47 INFO - PROCESS | 6469 | (process:6539): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:16:57 INFO - PROCESS | 6469 | RSS: Main: 151429120 07:16:57 INFO - PROCESS | 6469 | 07:17:00 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47565/tests/kraken/driver.html?testName=audio-beat-detection) 07:17:00 INFO - PROCESS | 6469 | RSS: Main: 156176384 07:17:00 INFO - PROCESS | 6469 | 07:17:03 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47565/tests/kraken/driver.html?testName=audio-dft) 07:17:04 INFO - PROCESS | 6469 | RSS: Main: 156319744 07:17:04 INFO - PROCESS | 6469 | 07:17:07 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47565/tests/kraken/driver.html?testName=audio-fft) 07:17:07 INFO - PROCESS | 6469 | RSS: Main: 156815360 07:17:07 INFO - PROCESS | 6469 | 07:17:09 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47565/tests/kraken/driver.html?testName=audio-oscillator) 07:17:10 INFO - PROCESS | 6469 | RSS: Main: 157048832 07:17:10 INFO - PROCESS | 6469 | 07:17:12 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47565/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:17:13 INFO - PROCESS | 6469 | RSS: Main: 156839936 07:17:13 INFO - PROCESS | 6469 | 07:17:16 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47565/tests/kraken/driver.html?testName=imaging-darkroom) 07:17:16 INFO - PROCESS | 6469 | RSS: Main: 156803072 07:17:16 INFO - PROCESS | 6469 | 07:17:20 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47565/tests/kraken/driver.html?testName=imaging-desaturate) 07:17:20 INFO - PROCESS | 6469 | RSS: Main: 157102080 07:17:20 INFO - PROCESS | 6469 | 07:17:23 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47565/tests/kraken/driver.html?testName=json-parse-financial) 07:17:24 INFO - PROCESS | 6469 | RSS: Main: 157016064 07:17:24 INFO - PROCESS | 6469 | 07:17:25 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47565/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:17:26 INFO - PROCESS | 6469 | RSS: Main: 157122560 07:17:26 INFO - PROCESS | 6469 | 07:17:28 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47565/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:17:28 INFO - PROCESS | 6469 | RSS: Main: 156721152 07:17:28 INFO - PROCESS | 6469 | 07:17:30 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47565/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:17:31 INFO - PROCESS | 6469 | RSS: Main: 156987392 07:17:31 INFO - PROCESS | 6469 | 07:17:33 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47565/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:17:34 INFO - PROCESS | 6469 | RSS: Main: 157261824 07:17:34 INFO - PROCESS | 6469 | 07:17:36 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47565/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:17:37 INFO - PROCESS | 6469 | RSS: Main: 157081600 07:17:37 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | Cycle 1(1): loaded http://localhost:47565/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47565/tests/kraken/driver.html?testName=ai-astar) 07:17:39 INFO - PROCESS | 6469 | RSS: Main: 158789632 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | __start_tp_report 07:17:39 INFO - PROCESS | 6469 | _x_x_mozilla_page_load 07:17:39 INFO - PROCESS | 6469 | _x_x_mozilla_page_load_details 07:17:39 INFO - PROCESS | 6469 | |i|pagename|runs| 07:17:39 INFO - PROCESS | 6469 | |0;ai-astar;111;106;111;109;112;121;112;110;111;110 07:17:39 INFO - PROCESS | 6469 | |1;audio-beat-detection;152;127;153;176;128;153;158;129;173;128 07:17:39 INFO - PROCESS | 6469 | |2;audio-dft;162;163;162;163;163;162;162;162;165;162 07:17:39 INFO - PROCESS | 6469 | |3;audio-fft;75;73;73;169;74;75;73;74;169;76 07:17:39 INFO - PROCESS | 6469 | |4;audio-oscillator;93;93;147;93;92;92;142;92;93;142 07:17:39 INFO - PROCESS | 6469 | |5;imaging-gaussian-blur;117;117;117;117;117;117;117;118;117;117 07:17:39 INFO - PROCESS | 6469 | |6;imaging-darkroom;147;147;147;148;147;147;147;148;153;146 07:17:39 INFO - PROCESS | 6469 | |7;imaging-desaturate;95;97;96;97;96;95;95;96;96;97 07:17:39 INFO - PROCESS | 6469 | |8;json-parse-financial;54;55;56;61;56;56;56;63;55;53 07:17:39 INFO - PROCESS | 6469 | |9;json-stringify-tinderbox;66;65;64;64;64;64;65;67;65;65 07:17:39 INFO - PROCESS | 6469 | |10;stanford-crypto-aes;78;78;79;79;80;79;86;80;78;78 07:17:39 INFO - PROCESS | 6469 | |11;stanford-crypto-ccm;120;112;120;114;119;116;115;119;121;120 07:17:39 INFO - PROCESS | 6469 | |12;stanford-crypto-pbkdf2;136;156;141;143;153;144;148;150;148;133 07:17:39 INFO - PROCESS | 6469 | |13;stanford-crypto-sha256-iterative;67;71;68;67;68;64;67;67;70;66 07:17:39 INFO - PROCESS | 6469 | __end_tp_report 07:17:39 INFO - PROCESS | 6469 | __start_cc_report 07:17:39 INFO - PROCESS | 6469 | _x_x_mozilla_cycle_collect,815 07:17:39 INFO - PROCESS | 6469 | __end_cc_report 07:17:39 INFO - PROCESS | 6469 | __startTimestamp1460643459468__endTimestamp 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | ------- Summary: start ------- 07:17:39 INFO - PROCESS | 6469 | Number of tests: 14 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#0] ai-astar Cycles:10 Average:111.30 Median:111.00 stddev:3.83 (3.5%) stddev-sans-first:4.06 07:17:39 INFO - PROCESS | 6469 | Values: 111.0 106.0 111.0 109.0 112.0 121.0 112.0 110.0 111.0 110.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#1] audio-beat-detection Cycles:10 Average:147.70 Median:153.00 stddev:18.79 (12.3%) stddev-sans-first:19.86 07:17:39 INFO - PROCESS | 6469 | Values: 152.0 127.0 153.0 176.0 128.0 153.0 158.0 129.0 173.0 128.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#2] audio-dft Cycles:10 Average:162.60 Median:162.50 stddev:0.97 (0.6%) stddev-sans-first:1.00 07:17:39 INFO - PROCESS | 6469 | Values: 162.0 163.0 162.0 163.0 163.0 162.0 162.0 162.0 165.0 162.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#3] audio-fft Cycles:10 Average:93.10 Median:74.00 stddev:40.02 (54.1%) stddev-sans-first:41.90 07:17:39 INFO - PROCESS | 6469 | Values: 75.0 73.0 73.0 169.0 74.0 75.0 73.0 74.0 169.0 76.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#4] audio-oscillator Cycles:10 Average:107.90 Median:92.50 stddev:24.72 (26.7%) stddev-sans-first:25.63 07:17:39 INFO - PROCESS | 6469 | Values: 93.0 93.0 147.0 93.0 92.0 92.0 142.0 92.0 93.0 142.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#5] imaging-gaussian-blur Cycles:10 Average:117.10 Median:117.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 07:17:39 INFO - PROCESS | 6469 | Values: 117.0 117.0 117.0 117.0 117.0 117.0 117.0 118.0 117.0 117.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#6] imaging-darkroom Cycles:10 Average:147.70 Median:147.00 stddev:1.95 (1.3%) stddev-sans-first:2.05 07:17:39 INFO - PROCESS | 6469 | Values: 147.0 147.0 147.0 148.0 147.0 147.0 147.0 148.0 153.0 146.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.00 stddev:0.82 (0.9%) stddev-sans-first:0.78 07:17:39 INFO - PROCESS | 6469 | Values: 95.0 97.0 96.0 97.0 96.0 95.0 95.0 96.0 96.0 97.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#8] json-parse-financial Cycles:10 Average:56.50 Median:56.00 stddev:3.10 (5.5%) stddev-sans-first:3.15 07:17:39 INFO - PROCESS | 6469 | Values: 54.0 55.0 56.0 61.0 56.0 56.0 56.0 63.0 55.0 53.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#9] json-stringify-tinderbox Cycles:10 Average:64.90 Median:65.00 stddev:0.99 (1.5%) stddev-sans-first:0.97 07:17:39 INFO - PROCESS | 6469 | Values: 66.0 65.0 64.0 64.0 64.0 64.0 65.0 67.0 65.0 65.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#10] stanford-crypto-aes Cycles:10 Average:79.50 Median:79.00 stddev:2.42 (3.1%) stddev-sans-first:2.50 07:17:39 INFO - PROCESS | 6469 | Values: 78.0 78.0 79.0 79.0 80.0 79.0 86.0 80.0 78.0 78.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#11] stanford-crypto-ccm Cycles:10 Average:117.60 Median:119.50 stddev:3.10 (2.6%) stddev-sans-first:3.16 07:17:39 INFO - PROCESS | 6469 | Values: 120.0 112.0 120.0 114.0 119.0 116.0 115.0 119.0 121.0 120.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.20 Median:148.00 stddev:7.25 (4.9%) stddev-sans-first:6.89 07:17:39 INFO - PROCESS | 6469 | Values: 136.0 156.0 141.0 143.0 153.0 144.0 148.0 150.0 148.0 133.0 07:17:39 INFO - PROCESS | 6469 | 07:17:39 INFO - PROCESS | 6469 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.50 Median:67.50 stddev:1.96 (2.9%) stddev-sans-first:2.07 07:17:39 INFO - PROCESS | 6469 | Values: 67.0 71.0 68.0 67.0 68.0 64.0 67.0 67.0 70.0 66.0 07:17:39 INFO - PROCESS | 6469 | -------- Summary: end -------- 07:17:39 INFO - PROCESS | 6469 | 07:17:40 INFO - TEST-INFO | 6469: exit 0 07:17:40 INFO - TEST-OK | kraken | took 60558ms 07:17:40 INFO - SUITE-END | took 1170s 07:17:40 INFO - Completed test suite (00:19:30) 07:17:40 INFO - javascript benchmark 07:17:40 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3317.3862835375453, 3373.814440205789, 3401.6768407001327, 3414.436617958037, 3427.9657203427973, 5554.1113421852515, 5557.305336832896, 5570.777168913243, 5576.525995290405, 5607.130894711316, 5559.972200139004, 5580.665160090397, 5597.580181486394, 5602.411746766592, 5610.354809196943, 5084.872878178047, 5129.281900533928, 5135.460776618457, 5171.663841850286, 5182.119039763231, 4997.225430058329, 5079.390473143209, 5149.459306772791, 5173.198154286091, 5208.374995000605, 5106.744662766865, 5160.122779127557, 5160.587153027749, 5172.767225474844, 5174.534291913727, 5162.457941916101, 5164.1995490699, 5181.274621552967, 5188.11801993662, 5208.088584497736, 4952.529509696573, 4989.451160372356, 5060.569851562622, 5089.465606111342, 5096.980603879239, 5269.789208431658, 5292.391374991887, 5293.285406470154, 5302.681839089667, 5304.124819404794, 5849.941500584982, 5859.0, 5880.059190529538, 5882.6764527950945, 5885.852853678693, 5931.199288096095, 5978.432048955342, 6005.4895333896675, 6046.727897244635, 6053.334133245339, 5627.6060675752715, 5660.462256085665, 5666.943330566683, 5669.9433005669825, 5676.0, 5971.28344598651, 6108.969455152695, 6152.692365381802, 6175.62946223228, 6204.317525072239, 5919.141724450017, 5981.222441082718, 5982.371850955674, 5988.371221021817, 5992.041273396236, 6069.271687397452, 6070.271567411939, 6070.7875224366935, 6072.878542429126, 6075.1191077294425, 5845.532357411397, 5999.460048595647, 6009.369016253318, 6037.335893051761, 6037.516998640098, 6005.249343832021, 6027.517798576191, 6037.667928263988, 6073.665948372882, 6110.144579758838, 4571.748553829505, 4591.471980722193, 4599.931001034987, 4603.102395033004, 4633.119707255611, 4024.537178224483, 4065.57311482296, 4114.526829414655, 4118.91762164761, 4140.192662430857, 5465.863353416196, 5590.18942253371, 5615.522680572197, 5625.353084395265, 5648.265725455664, 6023.337432882379, 6032.668203248776, 6035.637861728223, 6046.455818976226, 6052.606580572248, 5567.805126820542, 5612.775488980476, 5613.691246981455, 5640.097584386561, 5681.545476361881, 5128.076946149728, 5181.041507321158, 5187.688738675692, 5195.402528709171, 5195.792168313225, 6212.968935155295, 6213.03697926822, 6220.098085777537, 6225.0, 6230.6573138476915, 5871.6770577618645, 5934.910976335272, 5970.0, 5983.192269043798, 5996.130561068708, 6186.319504854552, 6219.626822390671, 6231.719572619152, 6254.3745625437095, 6275.843103922439, 5752.28096487939, 5958.910616340671, 5981.9401805983125, 5998.077028460983, 6022.45797878193, 5980.760769569342, 6036.8188954331445, 6039.758409663565, 6050.273967123973, 6068.666223357758, 5826.679532625577, 5873.5594830388745, 5875.148103525051, 5892.616979896293, 5905.675187864536, 5709.885802283848, 5848.0, 5866.794662186803, 5889.764409423575, 5908.497777688945, 5778.739956702043, 5794.797182098607, 5803.274590676166, 5835.503982161564, 5861.9706901465215, 5904.911426328523, 5905.911411328748, 5910.054391297372, 5938.61399009063, 5952.0, 5579.386267510652, 5695.658260504383, 5712.200291959212, 5795.94204057954, 5838.737256823538], "unit": "score", "name": "dojo.html", "value": 5532.754994484897}, {"lowerIsBetter": false, "replicates": [536.5010540197615, 549.7333793110341, 554.1798138754641, 579.168892639063, 597.3250227243215, 31247.843760781194, 40293.19413611726, 40632.59367406325, 40897.79551102241, 40912.59087409132, 43484.0, 44111.77944110283, 44268.0, 44357.77821110898, 44473.77763111188, 8828.161324674162, 8989.865152022725, 8990.10098990099, 8994.0, 9039.367244292902, 8778.429402088876, 8863.822723545525, 8873.778155546132, 8885.511296878669, 9109.863352049724, 9059.909400905972, 9132.041135680724, 9155.862662060075, 9187.95406022969, 9223.308251881102, 9047.366684332099, 9117.270618350516, 9130.086991300883, 9130.771730706752, 9137.908620913773, 9071.274298056205, 9139.314551408672, 9210.263178945668, 9238.891333040012, 9255.398399104037, 41351.7932410336, 41827.372589411185, 41839.58160418387, 41859.79070104661, 41955.53155639538, 3705.073731567108, 3771.981140094282, 3915.0, 4361.781910904442, 4428.136513379892, 33138.83430582831, 33430.0, 33514.0, 33713.49429758556, 33751.0, 4097.344424892033, 4133.751974881517, 4141.109661422808, 4150.149219410014, 4161.812718427678, 297616.0, 298006.0, 300260.0, 301166.0, 301920.0, 45921.0, 46434.535654643696, 67091.0, 67276.0, 67402.32597674058, 44758.10483790306, 44766.10467790626, 44844.32733509, 44958.55041449544, 45246.77376613096, 13445.260510672008, 13521.526746564019, 13539.729205416033, 13628.591142265748, 13636.181829090287, 11442.771144577062, 11474.967252947275, 11487.597934072268, 11504.0, 11533.88466115328, 15186.772198417033, 15653.139077350626, 15725.528234152993, 15826.208689565476, 15953.564179223926, 5985.581009329305, 6001.489873360813, 6005.759769609167, 6054.3945605439985, 6110.816675499742, 1027.306568066552, 1052.4474650808386, 1067.1782727299935, 1112.7551938573502, 1143.89704926557, 30280.697193028227, 30828.38343233123, 30950.0, 31142.532862007087, 31336.05991820249, 1048.8374301983206, 1111.372074777748, 1205.391277404905, 1205.6081773423673, 1226.576830993306, 15877.603059923364, 16015.359385624677, 16157.120646920535, 16188.838111618968, 16236.85960080172, 356418.0, 468619.0, 532076.0, 534890.0, 534934.0, 58275.12587311194, 58607.70696146492, 59168.0, 59299.70350148222, 59533.40466595279, 1450.760624496946, 1468.383279022813, 1473.9263036848329, 1480.104536755269, 1507.4121092773607, 30051.398972020874, 31559.89540366076, 33264.0, 33307.33385332328, 33365.0, 52874.0, 53208.467915320354, 53294.200586992, 53393.0, 53598.73200633972, 316041.0, 320110.0, 320196.0, 320411.0, 321383.0, 36310.27379452449, 36480.63519364772, 36876.631233687316, 36971.26057478889, 37282.44076338912, 49433.258501121796, 50429.74785126198, 50629.49370506248, 50721.49278507168, 51021.7448912753, 40191.397129043675, 41312.1737565253, 42494.575054249064, 43085.3537196936, 43253.0, 41235.793821030704, 41945.58054419417, 42031.0, 42085.78957105195, 42205.0, 40259.0, 40718.0, 41185.1762964745, 41238.79380603198, 41397.37903931383, 36164.819175903955, 36320.0, 37225.627743722216, 37276.25447491089, 37848.62151378451, 27615.447691045665, 27732.168034958984, 27809.721902781523, 27894.721052789213, 28064.43871122607], "unit": "score", "name": "ext.html", "value": 19583.799880255538}, {"lowerIsBetter": false, "replicates": [377.04419297081887, 381.7213434193038, 389.33229511387964, 389.9785511796851, 397.0906623831426, 17515.386961456352, 18221.817781822177, 18751.249950001984, 18752.812471875277, 18831.529211769714, 11921.761564768722, 12354.196977196498, 12366.752664946696, 12398.81401778974, 12406.937965310184, 5156.974215128919, 5296.867578310535, 5399.595030372718, 5585.162225666162, 5724.656520608777, 5497.945020549803, 5501.752421141038, 5551.694656793875, 5554.666719996793, 5579.581531385142, 5438.646487978289, 5540.778368865241, 5813.157092221625, 5846.50304724099, 5874.794382196624, 5773.740181691834, 5776.797812076578, 5789.710514474302, 5791.884162316751, 5796.13058041293, 5578.9163162552595, 5579.8884022319735, 5720.0, 5722.284714410699, 5739.311282646067, 14377.065490743069, 14420.42318307277, 16599.0, 20461.590768184553, 20839.062242199136, 2268.0, 2354.281944007077, 2511.0583531175807, 2895.4498645257336, 2991.8055326403714, 9893.901060989441, 10014.098731114234, 10313.89686103137, 10389.480525973746, 10429.21780866438, 1964.037621565437, 1971.5169783403157, 2031.2788959919312, 2055.2601063617085, 2071.2439959414855, 64232.0, 65429.0, 66883.3311666882, 67054.0, 68811.65594171998, 10365.9481702591, 10558.736031599117, 10662.573497060186, 10716.78566428667, 10719.19606029551, 14880.255987200813, 15134.243287835565, 15144.772828407582, 15179.392824286904, 15194.468193613171, 7562.130355009244, 7630.8092297693, 7645.847083058307, 7740.303372696484, 7941.841163176704, 7159.637319684492, 7218.242084581043, 7426.814329641694, 7432.9256707433315, 7534.321911028033, 4267.3598960155605, 4332.761698106571, 4572.0855828834365, 4600.700954438018, 4710.858674239778, 1919.9520011999812, 1959.2456904092028, 1970.5172232803054, 2037.2869495676691, 2037.6637854753799, 1072.1101485766794, 1089.1178145702006, 1107.9335239885634, 1142.274655593704, 1153.4578747988432, 17059.65880682404, 17822.198001089724, 17887.10564471771, 18137.909310453364, 18341.7248741269, 983.3755565216139, 1011.3173607814696, 1020.7346090016649, 1032.865727455426, 1103.448275862069, 10073.0, 10420.791584168273, 10484.895151048544, 10528.205716451648, 10704.839427408595, 441464.0, 447187.0, 451713.0, 452914.0, 453498.0, 80706.0, 81978.0, 82272.17727822645, 82370.0, 83128.58435707782, 1076.531708706715, 1079.3577821196375, 1088.9019988200941, 1097.6103483263325, 1106.4246591772232, 16324.67350653004, 16354.67290654204, 16502.0, 16503.17484125813, 16726.414575489798, 34006.319873602886, 34646.480302794975, 35620.82189589139, 35698.0, 36471.08822279464, 50038.74980625074, 50827.0, 51442.0, 51445.48554514407, 51585.22622160746, 8802.647894084164, 8872.467651940904, 8878.911210887809, 8935.146840167372, 9078.500682462529, 12563.623091307276, 12878.871211287767, 13061.0, 13086.80369794473, 13119.606411807279, 10673.89326106729, 10760.19298552596, 10813.405262710627, 10931.39877306724, 11315.603953861575, 11754.0, 11827.112966527373, 11971.700707482383, 11977.401129943642, 12218.26690398579, 10823.134149268197, 11025.503852326825, 11057.336559806437, 11098.5560577576, 11250.887491124984, 8791.868121978303, 8810.779730506532, 8873.64505419776, 8942.597583108645, 9064.728058158265, 10886.23796334249, 11020.834687479533, 11149.665510034712, 11196.328220306808, 11218.775624487627], "unit": "score", "name": "jquery.html", "value": 8808.46990872659}, {"lowerIsBetter": false, "replicates": [1531.747261701819, 1545.4977132431961, 1800.4418630224632, 1908.6755251607226, 1927.6433859735941, 7075.327843854839, 7915.722949696762, 8017.238362355574, 8272.296854767344, 8310.750677479678, 8253.793655158624, 8312.376571757111, 8428.283595894356, 8463.111373305806, 8463.957680211606, 2291.9083236670513, 2305.6310990241564, 2307.9423014424688, 2310.919117830876, 2319.1651005637955, 2295.036084844361, 2310.526342099874, 2367.479154585997, 2372.9914786215877, 2381.6070348392495, 2302.689136966513, 2302.9884850575722, 2309.2725791375747, 2319.199876042771, 2325.476767727265, 2258.322503249027, 2284.942876428086, 2285.0973865323103, 2296.0471404367336, 2310.0528783198806, 2298.1152256381247, 2310.560993411263, 2313.9305820825402, 2317.6523521471745, 2319.652052192168, 8340.624671889718, 8391.160883911622, 8408.789780255542, 8410.495370277742, 8413.0, 4997.925031124536, 5071.619628527875, 5087.160618497944, 5094.949050509485, 5104.489551044866, 3106.6582675905634, 3194.5847039884898, 3241.286916878283, 3246.107320486861, 3261.624913134996, 1073.457903758597, 1079.7786453777035, 1094.9616763413321, 1099.5656715597295, 1105.922585419021, 11264.831027534512, 11351.886481135249, 11353.20527563071, 11353.545858165664, 11357.886421135765, 4213.536510983789, 4391.385206071152, 4426.3581780641625, 4444.044530425974, 4452.042810795694, 9637.22902167825, 9694.466804325688, 9720.416774993522, 9722.465264410524, 9754.0, 5056.0, 5079.923801142986, 5104.515071068243, 5125.231215317732, 5128.153854613947, 4097.405876147942, 4522.977385113053, 4599.885002874955, 4650.813967441264, 4686.039361930796, 3797.6771974382486, 3842.2507611015585, 3871.109644781716, 3874.9612503875164, 3924.9215015699524, 1215.1858254969193, 1217.6225370135287, 1219.5000049979467, 1235.4625737804083, 1248.9875101249054, 1081.4971038466992, 1095.802755504017, 1099.9175061870392, 1264.9620511384674, 1357.911735737174, 7394.371478424394, 7418.591977441185, 7438.814029649302, 7441.330280274801, 7889.21107889218, 448.5111228760667, 449.63804137668836, 449.768369289816, 450.58321053026475, 478.2228878073131, 5771.740271687784, 5780.1907732917425, 5789.826305210766, 5818.854528636818, 5863.237779088691, 9593.952030239805, 9727.756806079904, 9730.805383892282, 9776.902230977741, 9819.852702209473, 9628.90371096294, 9631.422114673142, 9698.806023879624, 9704.078112579293, 9713.70858874235, 7508.699652013858, 7697.730579429693, 7766.611669416507, 7784.065912090586, 7853.842923141505, 7524.548527088392, 7650.349720273839, 7667.578283194478, 7677.117131529722, 7691.50005249657, 8514.659413623385, 9009.63961441535, 9095.772605684911, 9133.132352426508, 9140.0, 8752.037275899773, 8919.241864441596, 8926.285897128084, 8966.551672416223, 8991.820163596822, 7029.332213439715, 7183.748568800067, 7193.928060719326, 7206.531575447579, 7310.232425595449, 7739.535627862347, 7755.573443460664, 7765.107012693613, 7772.844543108993, 7784.610769461391, 6892.104026476526, 6915.619640919797, 6958.478114141359, 7033.0856988593205, 7050.189228238818, 6863.519553631198, 6865.794026179223, 6924.826879328057, 6960.408365288805, 6995.370416662525, 7278.854422911406, 7344.41244700412, 7381.11426628808, 7493.288137626917, 7552.244775522404, 6846.691898864464, 6854.657267136723, 6860.142482189726, 6870.27862074475, 6890.31096890307, 6947.478939079489, 7005.299470052954, 7020.613866237406, 7065.6113913735235, 7067.081279433641], "unit": "score", "name": "mootools.html", "value": 4576.859688075519}, {"lowerIsBetter": false, "replicates": [354.36214813336, 354.94320908654606, 358.04402246003167, 364.1497104261549, 373.3224198080484, 6390.616563006223, 6421.807345779628, 6453.83865403364, 6455.193100862392, 6467.805965821021, 6371.617702937815, 6377.139086223358, 6388.776392826252, 6398.4561312288515, 6401.263854656716, 4721.268203428474, 4743.075100355432, 4803.3995750531185, 4812.663113582051, 4899.853004409864, 4825.662203645747, 4854.587360074398, 4858.708477491344, 4867.415910090776, 4868.537488938545, 4785.545373189559, 4804.8078076877055, 4810.975945120287, 4813.7593120343845, 4823.493533179018, 4783.665143439978, 4822.565969062784, 4832.033593281322, 4836.37127173467, 4842.927356089662, 4158.064435501988, 4184.979075104605, 4189.162167566468, 4192.24539582875, 4199.958000419987, 5948.910766338508, 6098.0, 6101.115338275969, 6105.725242364104, 6112.480439162632, 5671.716414179275, 5677.460641239076, 5680.233168522238, 5684.317881854204, 5704.087346024658, 6711.899321510181, 6732.360425759545, 6736.427403670694, 6746.257911629717, 6747.93252067478, 4699.553542413465, 4707.223308154151, 4712.740799256039, 4717.481077081518, 4722.504137065627, 7035.92964070363, 7111.288871112847, 7115.1106111736035, 7118.92881071193, 7124.608146551937, 4731.384919960383, 4806.711597304173, 4831.758412079382, 4844.15227335215, 4856.635752318591, 4900.485449027872, 4913.582345500672, 4929.433115191727, 4935.506449355035, 4935.950640493621, 5654.236678048493, 5667.603267771299, 5673.489385955201, 5675.290588676416, 5695.373508914016, 6824.829379265558, 6825.897611535831, 6830.692618832164, 6836.350546698056, 6837.726490940307, 1715.1167148918316, 1744.1715185287142, 1745.2669878650997, 1745.4763570928671, 1745.6945034619146, 1110.1008183371496, 1119.5130118398522, 1139.925904816201, 1146.954121835134, 1160.048760016778, 6550.115734375799, 6565.048068030204, 6568.80293591193, 6582.341765823379, 6591.406773390322, 7022.0, 7073.92926070743, 7096.254893236136, 7097.361237488651, 7104.396126329217, 6374.649394283266, 6474.546781725234, 6488.513361497812, 6608.0, 6705.731770729214, 3818.2554401891366, 3831.9616803832164, 3853.5761066282685, 3868.477755502971, 3869.0134015825784, 7333.339999399973, 7366.079240094989, 7366.668499917517, 7375.483716139819, 7440.10718713747, 7213.206547279795, 7253.455990800711, 7262.055932728711, 7289.0, 7292.598907060056, 7131.82170445743, 7400.111986561539, 7409.481336306515, 7439.85120297591, 7440.85118297631, 7074.575525468488, 7097.82255443618, 7144.071270734979, 7162.928370716226, 7183.604901730246, 6996.650167491707, 7038.225795162426, 7084.433245340463, 7094.893576596252, 7101.183363913009, 7371.3734332582335, 7391.556506609621, 7406.481546291708, 7406.925930740624, 7407.888881666671, 4720.905581888412, 4819.927701084416, 4859.246816743411, 4862.246351815475, 4875.1224779540025, 7040.753573624898, 7066.364027237573, 7114.14630244374, 7122.786316410516, 7129.607871567114, 6827.829304267433, 6908.860038093659, 6909.550879192836, 6917.342852429011, 7001.36987671112, 6838.487113466609, 6889.104416425833, 6900.896486552605, 6904.3095690430555, 6911.101556797786, 6614.636195009129, 6708.798736037927, 6725.495587830835, 6731.057651928636, 6753.594784312957, 6879.174499060145, 6897.3447522485285, 6900.413464855544, 6913.965430172817, 6918.169819621678, 6716.227633821977, 6724.226713927961, 6742.056112144206, 6746.966265168643, 6776.356246156607], "unit": "score", "name": "prototype.html", "value": 5147.690733302449}, {"lowerIsBetter": false, "replicates": [805.0621026504122, 829.1584042197168, 860.8407444622742, 871.4117970369998, 887.9378443508955, 13594.0, 13730.038897277194, 13755.174689518635, 13849.515266965658, 13914.30428478577, 12962.546310879121, 13039.73920521589, 13088.73822523549, 13128.868711312884, 13150.342482875865, 762.5119923249125, 889.4840992224495, 897.2687259883174, 899.1772528136747, 912.7170577121113, 904.4799240436743, 904.8643951840431, 906.2342320738998, 907.9001309855911, 912.9406588571721, 964.3105179796444, 965.884093908732, 967.5307475874196, 968.2979839616293, 970.2335155227362, 950.2255661635745, 955.4267439536292, 958.228625956105, 960.2558017536395, 962.2157941277871, 707.7770502291762, 709.1986055757013, 711.9323664251888, 712.672170801432, 712.704227745485, 13879.444822207099, 13973.650658733613, 14005.579832605039, 14011.579652610439, 14015.0, 12187.878121218762, 13127.540536081191, 13253.204807711472, 13365.799513007312, 13454.730905381935, 10383.0, 12166.81749773754, 12637.178583392142, 12656.114072014963, 12913.289769062698, 3477.4088404971217, 3554.0937061049526, 3570.696490798285, 3573.9992802015217, 3592.7305452091196, 52673.47326526724, 53218.201726974126, 53341.0, 53824.19263711048, 54179.72910135503, 11029.724256893642, 11438.370889600985, 11483.885161148448, 11494.54021839117, 11656.825147622792, 20114.094865731076, 20298.797012029692, 20301.492462688257, 20325.89837050835, 20372.28696995598, 7046.43628509718, 7063.646817659096, 8019.879701804478, 8030.39772017101, 8202.507849529047, 4059.9594004060173, 4112.650424713933, 4336.0, 4362.847300344472, 4362.956370436318, 3370.224848284859, 3380.3746306932803, 3385.069105995871, 3391.576052993376, 3409.113630456099, 615.350804900834, 622.9190205273286, 623.2458724942779, 626.139058794158, 633.7021599848064, 665.6272487407067, 737.7602279259155, 755.4485225785207, 763.713607397226, 792.3977776889606, 7967.28294453502, 8157.918420815716, 8293.170682931659, 8430.0, 8448.788780280542, 653.4935425045628, 744.4156337275213, 745.4781652843031, 754.3701009656888, 754.4567911103996, 3714.851405943786, 3773.509443772347, 3777.150141218259, 3871.457995880579, 3873.2059927715313, 56941.0, 59200.0, 59755.0, 59881.401185988456, 59995.40004599986, 51170.48829511657, 51724.0, 51748.48251517512, 51962.740186298826, 52022.47977520252, 47481.76259118682, 48140.27789583159, 48359.75820120947, 48760.02479950452, 48790.75604622025, 7621.31408173267, 7675.769726908202, 8618.0, 9304.627814887328, 9317.0, 34716.0, 35286.29427411386, 37147.25705485929, 37854.81072594619, 38262.0, 45882.0, 46073.53926460692, 47020.529794701615, 47269.0, 47848.0, 12080.536912751691, 12137.757244855231, 12173.087018473827, 12237.265764054186, 12342.44458999365, 11277.830832537355, 13132.0, 13186.472541098248, 13890.374933127832, 14205.786913196516, 11879.346635935106, 12113.75772484563, 12413.503459861504, 13107.951363891056, 13306.46774129024, 11627.12796540246, 11633.941830290794, 11722.120840937134, 11745.29528228309, 12884.162529435556, 11920.0, 12337.444814983526, 12399.25604463735, 12450.688732781753, 12616.0, 10099.44453055089, 10199.898001019896, 10237.334573252714, 10781.245312828027, 10851.782964340511, 10943.507542160782, 11030.834537481784, 11159.72100697489, 11173.832392513956, 11242.943785281348], "unit": "score", "name": "yui.html", "value": 6741.512945486518}], "name": "dromaeo_css", "value": 7302.174073239297}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 106.0, 111.0, 109.0, 112.0, 121.0, 112.0, 110.0, 111.0, 110.0], "unit": "score", "name": "ai-astar", "value": 111.3}, {"lowerIsBetter": true, "replicates": [152.0, 127.0, 153.0, 176.0, 128.0, 153.0, 158.0, 129.0, 173.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 147.7}, {"lowerIsBetter": true, "replicates": [162.0, 163.0, 162.0, 163.0, 163.0, 162.0, 162.0, 162.0, 165.0, 162.0], "unit": "score", "name": "audio-dft", "value": 162.6}, {"lowerIsBetter": true, "replicates": [75.0, 73.0, 73.0, 169.0, 74.0, 75.0, 73.0, 74.0, 169.0, 76.0], "unit": "score", "name": "audio-fft", "value": 93.1}, {"lowerIsBetter": true, "replicates": [93.0, 93.0, 147.0, 93.0, 92.0, 92.0, 142.0, 92.0, 93.0, 142.0], "unit": "score", "name": "audio-oscillator", "value": 107.9}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 118.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.1}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 147.0, 148.0, 147.0, 147.0, 147.0, 148.0, 153.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 147.7}, {"lowerIsBetter": true, "replicates": [95.0, 97.0, 96.0, 97.0, 96.0, 95.0, 95.0, 96.0, 96.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 96.0}, {"lowerIsBetter": true, "replicates": [54.0, 55.0, 56.0, 61.0, 56.0, 56.0, 56.0, 63.0, 55.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 56.5}, {"lowerIsBetter": true, "replicates": [66.0, 65.0, 64.0, 64.0, 64.0, 64.0, 65.0, 67.0, 65.0, 65.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.9}, {"lowerIsBetter": true, "replicates": [78.0, 78.0, 79.0, 79.0, 80.0, 79.0, 86.0, 80.0, 78.0, 78.0], "unit": "score", "name": "stanford-crypto-aes", "value": 79.5}, {"lowerIsBetter": true, "replicates": [120.0, 112.0, 120.0, 114.0, 119.0, 116.0, 115.0, 119.0, 121.0, 120.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 117.6}, {"lowerIsBetter": true, "replicates": [136.0, 156.0, 141.0, 143.0, 153.0, 144.0, 148.0, 150.0, 148.0, 133.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 145.2}, {"lowerIsBetter": true, "replicates": [67.0, 71.0, 68.0, 67.0, 68.0, 64.0, 67.0, 67.0, 70.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.5}], "name": "kraken", "value": 1514.6000000000001}]} 07:17:40 INFO - Return code: 0 07:17:40 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 07:17:40 ERROR - # TBPL SUCCESS # 07:17:40 INFO - Running post-action listener: _resource_record_post_action 07:17:40 INFO - Running post-run listener: _resource_record_post_run 07:17:41 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 278528; Write bytes: 507830272; Read time: 40; Write time: 457928 07:17:41 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 190976000; Read time: 0; Write time: 237212 07:17:41 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 278528; Write bytes: 253485056; Read time: 40; Write time: 168204 07:17:41 INFO - Running post-run listener: _upload_blobber_files 07:17:41 INFO - Blob upload gear active. 07:17:41 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:17:41 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 07:17:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:17:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:17:42 INFO - (blobuploader) - INFO - Open directory for files ... 07:17:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:17:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:17:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:17:43 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:17:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:17:43 INFO - (blobuploader) - INFO - Done attempting. 07:17:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:17:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:17:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:17:43 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:17:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:17:43 INFO - (blobuploader) - INFO - Done attempting. 07:17:43 INFO - (blobuploader) - INFO - Iteration through files over. 07:17:43 INFO - Return code: 0 07:17:43 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:17:43 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:17:43 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fea126c62ea58fbeb740e19c9823f3b69ed9c88cfc3fe8617744e3ca8ee4306bb1088a65e412061bf605241f0c06a3d9f1aa2d3a8768118d544d48d9dd4a6522", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c0befe7347b3929659617ac396a27c28aec707f957a80654e67ead392748ce2120c3cc05298bb669e866b064c253d0e631e8f0740152b0112fa7a402927df625"} 07:17:43 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:17:43 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:17:43 INFO - Contents: 07:17:43 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fea126c62ea58fbeb740e19c9823f3b69ed9c88cfc3fe8617744e3ca8ee4306bb1088a65e412061bf605241f0c06a3d9f1aa2d3a8768118d544d48d9dd4a6522", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c0befe7347b3929659617ac396a27c28aec707f957a80654e67ead392748ce2120c3cc05298bb669e866b064c253d0e631e8f0740152b0112fa7a402927df625"} 07:17:43 INFO - Running post-run listener: copy_logs_to_upload_dir 07:17:43 INFO - Copying logs to upload dir... 07:17:43 INFO - mkdir: /builds/slave/test/build/upload/logs 07:17:43 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1229.414753 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 29 secs) (at 2016-04-14 07:17:43.699566) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-14 07:17:43.702598) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fea126c62ea58fbeb740e19c9823f3b69ed9c88cfc3fe8617744e3ca8ee4306bb1088a65e412061bf605241f0c06a3d9f1aa2d3a8768118d544d48d9dd4a6522", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c0befe7347b3929659617ac396a27c28aec707f957a80654e67ead392748ce2120c3cc05298bb669e866b064c253d0e631e8f0740152b0112fa7a402927df625"} build_url:https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011297 build_url: 'https://queue.taskcluster.net/v1/task/XIPflxN_SMKAGo6fYDJdGw/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fea126c62ea58fbeb740e19c9823f3b69ed9c88cfc3fe8617744e3ca8ee4306bb1088a65e412061bf605241f0c06a3d9f1aa2d3a8768118d544d48d9dd4a6522", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c0befe7347b3929659617ac396a27c28aec707f957a80654e67ead392748ce2120c3cc05298bb669e866b064c253d0e631e8f0740152b0112fa7a402927df625"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-14 07:17:43.727567) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-14 07:17:43.727890) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1460639202.213940-950940563 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004426 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-14 07:17:43.810178) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-14 07:17:43.810543) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-14 07:17:43.810857) ========= ========= Total master_lag: 0.17 =========