builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-011 starttime: 1452601238.81 results: success (0) buildid: 20160112025755 builduid: 8b1dcbbf5013471c9f636c636d01352c revision: 314864749307f5450fd7ef9aaadd1af19cb75f82 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.812613) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.813118) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.813459) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] 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=5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.004348 basedir: '/builds/slave/test' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.830850) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.831190) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.844721) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.845107) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', '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=5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004580 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.895425) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.895770) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.896187) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:38.896509) ========= 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=5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-12 04:20:39-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 224M=0s 2016-01-12 04:20:40 (224 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.538446 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:39.447955) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:39.448331) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] 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=5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013787 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:39.498543) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:39.498932) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 314864749307f5450fd7ef9aaadd1af19cb75f82 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 314864749307f5450fd7ef9aaadd1af19cb75f82 --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=5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-12 04:20:40,476 truncating revision to first 12 chars 2016-01-12 04:20:40,476 Setting DEBUG logging. 2016-01-12 04:20:40,476 attempt 1/10 2016-01-12 04:20:40,476 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/314864749307?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-12 04:20:41,161 unpacking tar archive at: fx-team-314864749307/testing/mozharness/ program finished with exit code 0 elapsedTime=0.979948 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:40.493546) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:40.493922) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:40.502958) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:40.503308) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-12 04:20:40.503754) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 19 secs) (at 2016-01-12 04:20:40.504108) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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=5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:20:41 INFO - MultiFileLogger online at 20160112 04:20:41 in /builds/slave/test 04:20:41 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 04:20:41 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:20:41 INFO - {'append_to_log': False, 04:20:41 INFO - 'base_work_dir': '/builds/slave/test', 04:20:41 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 04:20:41 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:20:41 INFO - 'branch': 'Fx-Team-Non-PGO', 04:20:41 INFO - 'buildbot_json_path': 'buildprops.json', 04:20:41 INFO - 'config_files': ('talos/linux_config.py',), 04:20:41 INFO - 'default_actions': ('clobber', 04:20:41 INFO - 'read-buildbot-config', 04:20:41 INFO - 'download-and-extract', 04:20:41 INFO - 'populate-webroot', 04:20:41 INFO - 'create-virtualenv', 04:20:41 INFO - 'install', 04:20:41 INFO - 'run-tests'), 04:20:41 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:20:41 INFO - 'download_minidump_stackwalk': True, 04:20:41 INFO - 'download_symbols': 'ondemand', 04:20:41 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:20:41 INFO - 'tooltool.py': '/tools/tooltool.py', 04:20:41 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:20:41 INFO - '/tools/misc-python/virtualenv.py')}, 04:20:41 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:20:41 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:20:41 INFO - 'installer_path': 'installer.exe', 04:20:41 INFO - 'log_level': 'info', 04:20:41 INFO - 'log_name': 'talos', 04:20:41 INFO - 'log_to_console': True, 04:20:41 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:20:41 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:20:41 INFO - 'opt_config_files': (), 04:20:41 INFO - 'pip_index': False, 04:20:41 INFO - 'sps_profile': False, 04:20:41 INFO - 'sps_profile_interval': 0, 04:20:41 INFO - 'suite': 'dromaeojs-e10s', 04:20:41 INFO - 'system_bits': '32', 04:20:41 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:20:41 INFO - 'title': 'talos-linux64-ix-011', 04:20:41 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:20:41 INFO - 'use_talos_json': True, 04:20:41 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:20:41 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:20:41 INFO - 'work_dir': 'build'} 04:20:41 INFO - ##### 04:20:41 INFO - ##### Running clobber step. 04:20:41 INFO - ##### 04:20:41 INFO - Running pre-action listener: _resource_record_pre_action 04:20:41 INFO - Running main action method: clobber 04:20:41 INFO - rmtree: /builds/slave/test/build 04:20:41 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:20:42 INFO - Running post-action listener: _resource_record_post_action 04:20:42 INFO - ##### 04:20:42 INFO - ##### Running read-buildbot-config step. 04:20:42 INFO - ##### 04:20:42 INFO - Running pre-action listener: _resource_record_pre_action 04:20:42 INFO - Running main action method: read_buildbot_config 04:20:42 INFO - Using buildbot properties: 04:20:42 INFO - { 04:20:42 INFO - "project": "", 04:20:42 INFO - "product": "firefox", 04:20:42 INFO - "script_repo_revision": "production", 04:20:42 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 04:20:42 INFO - "repository": "", 04:20:42 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 04:20:42 INFO - "buildid": "20160112025755", 04:20:42 INFO - "pgo_build": "False", 04:20:42 INFO - "basedir": "/builds/slave/test", 04:20:42 INFO - "buildnumber": 635, 04:20:42 INFO - "slavename": "talos-linux64-ix-011", 04:20:42 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 04:20:42 INFO - "platform": "ubuntu64_hw", 04:20:42 INFO - "scheduler": "tests-fx-team-linux64-talos", 04:20:42 INFO - "branch": "fx-team", 04:20:42 INFO - "repo_path": "integration/fx-team", 04:20:42 INFO - "revision": "314864749307f5450fd7ef9aaadd1af19cb75f82", 04:20:42 INFO - "stage_platform": "linux64", 04:20:42 INFO - "builduid": "8b1dcbbf5013471c9f636c636d01352c", 04:20:42 INFO - "slavebuilddir": "test" 04:20:42 INFO - } 04:20:42 INFO - Found installer url https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 04:20:42 INFO - Running post-action listener: _resource_record_post_action 04:20:42 INFO - ##### 04:20:42 INFO - ##### Running download-and-extract step. 04:20:42 INFO - ##### 04:20:42 INFO - Running pre-action listener: _resource_record_pre_action 04:20:42 INFO - Running main action method: download_and_extract 04:20:42 INFO - mkdir: /builds/slave/test/build/tests 04:20:42 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')]} 04:20:42 INFO - https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 04:20:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/test_packages.json 04:20:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/test_packages.json 04:20:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 04:20:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 04:20:43 INFO - Downloaded 1302 bytes. 04:20:43 INFO - Reading from file /builds/slave/test/build/test_packages.json 04:20:43 INFO - Using the following test package requirements: 04:20:43 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 04:20:43 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:20:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:20:43 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:20:43 INFO - u'jsshell-linux-x86_64.zip'], 04:20:43 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:20:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:20:43 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 04:20:43 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:20:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:20:43 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:20:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:20:43 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:20:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:20:43 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 04:20:43 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:20:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:20:43 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:20: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')]} 04:20:43 INFO - https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:20:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:20:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:20:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:20:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:20:45 INFO - Downloaded 22758864 bytes. 04:20:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 04:20:45 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:20:45 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 04:20:47 INFO - Return code: 0 04:20:47 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:20: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')]} 04:20:47 INFO - https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:20:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:20:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:20:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:20:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:20:49 INFO - Downloaded 22758864 bytes. 04:20:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 04:20:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:20:49 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 04:20:51 INFO - Return code: 0 04:20:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:20:51 INFO - https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:20:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 04:20:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 04:20:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 04:20:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:20:53 INFO - Downloaded 11132285 bytes. 04:20:53 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 04:20:53 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 04:20:53 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 04:20:53 INFO - Return code: 0 04:20:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:20:53 INFO - https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:20:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:20:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:20:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:20:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:20:56 INFO - Downloaded 53857187 bytes. 04:20:56 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:20:56 INFO - mkdir: /builds/slave/test/properties 04:20:56 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:20:56 INFO - Writing to file /builds/slave/test/properties/build_url 04:20:56 INFO - Contents: 04:20:56 INFO - build_url:https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:20:56 INFO - Running post-action listener: _resource_record_post_action 04:20:56 INFO - Running post-action listener: set_extra_try_arguments 04:20:56 INFO - ##### 04:20:56 INFO - ##### Running populate-webroot step. 04:20:56 INFO - ##### 04:20:56 INFO - Running pre-action listener: _resource_record_pre_action 04:20:56 INFO - Running main action method: populate_webroot 04:20:56 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:20:56 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:20:56 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:20:56 INFO - '--tppagecycles', 04:20:56 INFO - '7'], 04:20:56 INFO - 'tests': ['tsvgm']}}, 04:20:56 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:20:56 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:20:56 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:20:56 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:20:56 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:20:56 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:20:56 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:20:56 INFO - 'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:20:56 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:20:56 INFO - 'tests': ['damp', 'tps']}, 04:20:56 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:20:56 INFO - 'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['damp', 'tps']}, 04:20:56 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:20:56 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:20:56 INFO - 'other': {'tests': ['a11yr', 04:20:56 INFO - 'ts_paint', 04:20:56 INFO - 'tpaint', 04:20:56 INFO - 'sessionrestore', 04:20:56 INFO - 'sessionrestore_no_auto_restore']}, 04:20:56 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['a11yr', 04:20:56 INFO - 'ts_paint', 04:20:56 INFO - 'tpaint', 04:20:56 INFO - 'sessionrestore', 04:20:56 INFO - 'sessionrestore_no_auto_restore']}, 04:20:56 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['a11yr', 04:20:56 INFO - 'ts_paint', 04:20:56 INFO - 'tpaint', 04:20:56 INFO - 'sessionrestore', 04:20:56 INFO - 'sessionrestore_no_auto_restore']}, 04:20:56 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['a11yr', 04:20:56 INFO - 'ts_paint', 04:20:56 INFO - 'tpaint', 04:20:56 INFO - 'sessionrestore', 04:20:56 INFO - 'sessionrestore_no_auto_restore']}, 04:20:56 INFO - 'other_l64': {'tests': ['a11yr', 04:20:56 INFO - 'ts_paint', 04:20:56 INFO - 'tpaint', 04:20:56 INFO - 'sessionrestore', 04:20:56 INFO - 'sessionrestore_no_auto_restore']}, 04:20:56 INFO - 'other_nol64': {'tests': ['a11yr', 04:20:56 INFO - 'ts_paint', 04:20:56 INFO - 'tpaint', 04:20:56 INFO - 'sessionrestore', 04:20:56 INFO - 'sessionrestore_no_auto_restore']}, 04:20:56 INFO - 'svgr': {'tests': ['tsvgx', 04:20:56 INFO - 'tsvgr_opacity', 04:20:56 INFO - 'tart', 04:20:56 INFO - 'tscrollx', 04:20:56 INFO - 'cart']}, 04:20:56 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['tsvgx', 04:20:56 INFO - 'tsvgr_opacity', 04:20:56 INFO - 'tart', 04:20:56 INFO - 'tscrollx', 04:20:56 INFO - 'cart']}, 04:20:56 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:20:56 INFO - 'tests': ['tp5o']}, 04:20:56 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:20:56 INFO - 'talos_options': ['--e10s'], 04:20:56 INFO - 'tests': ['tp5o']}, 04:20:56 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:20:56 INFO - 'talos_options': ['--xperf_path', 04:20:56 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:20:56 INFO - 'tests': ['tp5n']}, 04:20:56 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:20:56 INFO - 'talos_options': ['--e10s', 04:20:56 INFO - '--xperf_path', 04:20:56 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:20:56 INFO - 'tests': ['tp5n']}}, 04:20:56 INFO - 'talos.zip': {'path': '', 04:20:56 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:20:56 INFO - Running post-action listener: _resource_record_post_action 04:20:56 INFO - ##### 04:20:56 INFO - ##### Running create-virtualenv step. 04:20:56 INFO - ##### 04:20:56 INFO - Running pre-action listener: _resource_record_pre_action 04:20:56 INFO - Running main action method: create_virtualenv 04:20:56 INFO - Creating virtualenv /builds/slave/test/build/venv 04:20:56 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 04:20:56 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:20:56 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:20:56 INFO - Using real prefix '/usr' 04:20:56 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:20:57 INFO - Installing distribute.............................................................................................................................................................................................done. 04:20:59 INFO - Installing pip.................done. 04:20:59 INFO - Return code: 0 04:20:59 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:20:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:20:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:20:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:20:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:20:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:20:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:20:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:20:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:20:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 04:20:59 INFO - Using env: {'DISPLAY': ':0', 04:20:59 INFO - 'HOME': '/home/cltbld', 04:20:59 INFO - 'LANG': 'en_US.UTF-8', 04:20:59 INFO - 'LANGUAGE': 'en_US:en', 04:20:59 INFO - 'LOGNAME': 'cltbld', 04:20:59 INFO - 'MAIL': '/var/mail/cltbld', 04:20:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:20:59 INFO - 'MOZ_NO_REMOTE': '1', 04:20:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:20:59 INFO - 'NO_EM_RESTART': '1', 04:20:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:20:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:20:59 INFO - 'PWD': '/builds/slave/test', 04:20:59 INFO - 'SHELL': '/bin/bash', 04:20:59 INFO - 'SHLVL': '1', 04:20:59 INFO - 'TERM': 'linux', 04:20:59 INFO - 'TMOUT': '86400', 04:20:59 INFO - 'USER': 'cltbld', 04:20:59 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:20:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:20:59 INFO - '_': '/tools/buildbot/bin/python'} 04:20:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:20:59 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 04:20:59 INFO - Cleaning up... 04:20:59 INFO - Return code: 0 04:20:59 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:20:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:20:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:20:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:20:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:20:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:20:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:20:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:20:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:20:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 04:20:59 INFO - Using env: {'DISPLAY': ':0', 04:20:59 INFO - 'HOME': '/home/cltbld', 04:20:59 INFO - 'LANG': 'en_US.UTF-8', 04:20:59 INFO - 'LANGUAGE': 'en_US:en', 04:20:59 INFO - 'LOGNAME': 'cltbld', 04:20:59 INFO - 'MAIL': '/var/mail/cltbld', 04:20:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:20:59 INFO - 'MOZ_NO_REMOTE': '1', 04:20:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:20:59 INFO - 'NO_EM_RESTART': '1', 04:20:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:20:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:20:59 INFO - 'PWD': '/builds/slave/test', 04:20:59 INFO - 'SHELL': '/bin/bash', 04:20:59 INFO - 'SHLVL': '1', 04:20:59 INFO - 'TERM': 'linux', 04:20:59 INFO - 'TMOUT': '86400', 04:20:59 INFO - 'USER': 'cltbld', 04:20:59 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:20:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:20:59 INFO - '_': '/tools/buildbot/bin/python'} 04:20:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:20:59 INFO - Downloading/unpacking psutil>=0.7.1 04:20:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:20:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:20:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:20:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:20:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:20:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:21:01 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 04:21:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 04:21:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:21:01 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:21:01 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:21:01 INFO - Installing collected packages: psutil 04:21:01 INFO - Running setup.py install for psutil 04:21:01 INFO - building 'psutil._psutil_linux' extension 04:21:01 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 04:21:01 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 04:21:01 INFO - building 'psutil._psutil_posix' extension 04:21:01 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 04:21:01 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 04:21:01 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:21:01 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:21:01 INFO - Successfully installed psutil 04:21:01 INFO - Cleaning up... 04:21:02 INFO - Return code: 0 04:21:02 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:21:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:21:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:21:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:21:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:21:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:21:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:21:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 04:21:02 INFO - Using env: {'DISPLAY': ':0', 04:21:02 INFO - 'HOME': '/home/cltbld', 04:21:02 INFO - 'LANG': 'en_US.UTF-8', 04:21:02 INFO - 'LANGUAGE': 'en_US:en', 04:21:02 INFO - 'LOGNAME': 'cltbld', 04:21:02 INFO - 'MAIL': '/var/mail/cltbld', 04:21:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:21:02 INFO - 'MOZ_NO_REMOTE': '1', 04:21:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:21:02 INFO - 'NO_EM_RESTART': '1', 04:21:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:21:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:21:02 INFO - 'PWD': '/builds/slave/test', 04:21:02 INFO - 'SHELL': '/bin/bash', 04:21:02 INFO - 'SHLVL': '1', 04:21:02 INFO - 'TERM': 'linux', 04:21:02 INFO - 'TMOUT': '86400', 04:21:02 INFO - 'USER': 'cltbld', 04:21:02 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:21:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:21:02 INFO - '_': '/tools/buildbot/bin/python'} 04:21:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:21:02 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:21:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:21:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:21:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:21:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:21:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:21:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:21:03 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:21:03 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 04:21:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:21:03 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 04:21:03 INFO - Installing collected packages: mozsystemmonitor 04:21:03 INFO - Running setup.py install for mozsystemmonitor 04:21:04 INFO - Successfully installed mozsystemmonitor 04:21:04 INFO - Cleaning up... 04:21:04 INFO - Return code: 0 04:21:04 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:21:04 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')]} 04:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:21:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:04 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')]} 04:21:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:21:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:21:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:21:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 04:21:04 INFO - Using env: {'DISPLAY': ':0', 04:21:04 INFO - 'HOME': '/home/cltbld', 04:21:04 INFO - 'LANG': 'en_US.UTF-8', 04:21:04 INFO - 'LANGUAGE': 'en_US:en', 04:21:04 INFO - 'LOGNAME': 'cltbld', 04:21:04 INFO - 'MAIL': '/var/mail/cltbld', 04:21:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:21:04 INFO - 'MOZ_NO_REMOTE': '1', 04:21:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:21:04 INFO - 'NO_EM_RESTART': '1', 04:21:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:21:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:21:04 INFO - 'PWD': '/builds/slave/test', 04:21:04 INFO - 'SHELL': '/bin/bash', 04:21:04 INFO - 'SHLVL': '1', 04:21:04 INFO - 'TERM': 'linux', 04:21:04 INFO - 'TMOUT': '86400', 04:21:04 INFO - 'USER': 'cltbld', 04:21:04 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:21:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:21:04 INFO - '_': '/tools/buildbot/bin/python'} 04:21:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:21:04 INFO - Downloading/unpacking blobuploader==1.2.4 04:21:04 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 04:21:04 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 04:21:04 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 04:21:04 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 04:21:04 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 04:21:04 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 04:21:06 INFO - Downloading blobuploader-1.2.4.tar.gz 04:21:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 04:21:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:21:06 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:21:06 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 04:21:06 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 04:21:06 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 04:21:06 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 04:21:06 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 04:21:06 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 04:21:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 04:21:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:21:06 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:21:06 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 04:21:06 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 04:21:06 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 04:21:06 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 04:21:06 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 04:21:06 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 04:21:06 INFO - Downloading docopt-0.6.1.tar.gz 04:21:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 04:21:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:21:06 INFO - Installing collected packages: blobuploader, requests, docopt 04:21:06 INFO - Running setup.py install for blobuploader 04:21:06 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:21:06 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:21:06 INFO - Running setup.py install for requests 04:21:07 INFO - Running setup.py install for docopt 04:21:07 INFO - Successfully installed blobuploader requests docopt 04:21:07 INFO - Cleaning up... 04:21:07 INFO - Return code: 0 04:21:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:21:07 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')]} 04:21:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:21:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:07 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')]} 04:21:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:21:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:21:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:21:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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 04:21:07 INFO - Using env: {'DISPLAY': ':0', 04:21:07 INFO - 'HOME': '/home/cltbld', 04:21:07 INFO - 'LANG': 'en_US.UTF-8', 04:21:07 INFO - 'LANGUAGE': 'en_US:en', 04:21:07 INFO - 'LOGNAME': 'cltbld', 04:21:07 INFO - 'MAIL': '/var/mail/cltbld', 04:21:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:21:07 INFO - 'MOZ_NO_REMOTE': '1', 04:21:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:21:07 INFO - 'NO_EM_RESTART': '1', 04:21:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:21:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:21:07 INFO - 'PWD': '/builds/slave/test', 04:21:07 INFO - 'SHELL': '/bin/bash', 04:21:07 INFO - 'SHLVL': '1', 04:21:07 INFO - 'TERM': 'linux', 04:21:07 INFO - 'TMOUT': '86400', 04:21:07 INFO - 'USER': 'cltbld', 04:21:07 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:21:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:21:07 INFO - '_': '/tools/buildbot/bin/python'} 04:21:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:21:07 INFO - Running setup.py (path:/tmp/pip-WAXD5i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:21:07 INFO - Running setup.py (path:/tmp/pip-vDef_V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:21:07 INFO - Running setup.py (path:/tmp/pip-HLoiwt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:21:07 INFO - Running setup.py (path:/tmp/pip-yM7r4O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:21:07 INFO - Running setup.py (path:/tmp/pip-ptjZ4W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:21:08 INFO - Running setup.py (path:/tmp/pip-dyXeni-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:21:08 INFO - Running setup.py (path:/tmp/pip-tnBMtA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:21:08 INFO - Running setup.py (path:/tmp/pip-JbFdst-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:21:08 INFO - Running setup.py (path:/tmp/pip-YLZcdy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:21:08 INFO - Running setup.py (path:/tmp/pip-kbjx2c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:21:08 INFO - Running setup.py (path:/tmp/pip-FkXVLF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:21:08 INFO - Running setup.py (path:/tmp/pip-NmYhed-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:21:08 INFO - Running setup.py (path:/tmp/pip-m0daSo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:21:08 INFO - Running setup.py (path:/tmp/pip-HpCyPX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:21:08 INFO - Running setup.py (path:/tmp/pip-kXWsoX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:21:08 INFO - Running setup.py (path:/tmp/pip-E9xcl0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:21:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:21:08 INFO - Running setup.py (path:/tmp/pip-cNdTHQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:21:08 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:21:08 INFO - Running setup.py install for manifestparser 04:21:09 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Running setup.py install for mozcrash 04:21:09 INFO - Running setup.py install for mozdebug 04:21:09 INFO - Running setup.py install for mozdevice 04:21:09 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Running setup.py install for mozfile 04:21:09 INFO - Running setup.py install for mozhttpd 04:21:09 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Running setup.py install for mozinfo 04:21:09 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Running setup.py install for mozInstall 04:21:09 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Running setup.py install for mozleak 04:21:09 INFO - Running setup.py install for mozlog 04:21:09 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:21:09 INFO - Running setup.py install for moznetwork 04:21:10 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:21:10 INFO - Running setup.py install for mozprocess 04:21:10 INFO - Running setup.py install for mozprofile 04:21:10 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:21:10 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:21:10 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:21:10 INFO - Running setup.py install for mozrunner 04:21:10 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:21:10 INFO - Running setup.py install for mozscreenshot 04:21:10 INFO - Running setup.py install for moztest 04:21:10 INFO - Running setup.py install for mozversion 04:21:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:21:10 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:21:10 INFO - Cleaning up... 04:21:10 INFO - Return code: 0 04:21:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:21:10 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')]} 04:21:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:21:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:10 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')]} 04:21:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:21:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:21:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:21:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 04:21:10 INFO - Using env: {'DISPLAY': ':0', 04:21:10 INFO - 'HOME': '/home/cltbld', 04:21:10 INFO - 'LANG': 'en_US.UTF-8', 04:21:10 INFO - 'LANGUAGE': 'en_US:en', 04:21:10 INFO - 'LOGNAME': 'cltbld', 04:21:10 INFO - 'MAIL': '/var/mail/cltbld', 04:21:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:21:10 INFO - 'MOZ_NO_REMOTE': '1', 04:21:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:21:10 INFO - 'NO_EM_RESTART': '1', 04:21:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:21:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:21:10 INFO - 'PWD': '/builds/slave/test', 04:21:10 INFO - 'SHELL': '/bin/bash', 04:21:10 INFO - 'SHLVL': '1', 04:21:10 INFO - 'TERM': 'linux', 04:21:10 INFO - 'TMOUT': '86400', 04:21:10 INFO - 'USER': 'cltbld', 04:21:10 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:21:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:21:10 INFO - '_': '/tools/buildbot/bin/python'} 04:21:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:21:10 INFO - Running setup.py (path:/tmp/pip-CEDTYX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:21:10 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)) 04:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:21:10 INFO - Running setup.py (path:/tmp/pip-FEpaI7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:21:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:21:11 INFO - Running setup.py (path:/tmp/pip-TrNVhb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:21:11 INFO - Running setup.py (path:/tmp/pip-hlguTh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:21:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:21:11 INFO - Running setup.py (path:/tmp/pip-lkJWGn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:21:11 INFO - Running setup.py (path:/tmp/pip-KwAPo9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:21:11 INFO - Running setup.py (path:/tmp/pip-ikipk5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:21:11 INFO - Running setup.py (path:/tmp/pip-ZWPaCV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:21:11 INFO - Running setup.py (path:/tmp/pip-hDJInX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:21:11 INFO - Running setup.py (path:/tmp/pip-eEf0_W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:21:11 INFO - Running setup.py (path:/tmp/pip-5Wwtg4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:21:11 INFO - Running setup.py (path:/tmp/pip-N_N0OT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:21:11 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)) 04:21:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:21:11 INFO - Running setup.py (path:/tmp/pip-pUwaTE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:21:11 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)) 04:21:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:21:12 INFO - Running setup.py (path:/tmp/pip-w46RwY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:21:12 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)) 04:21:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:21:12 INFO - Running setup.py (path:/tmp/pip-buY97M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:21:12 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)) 04:21:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:21:12 INFO - Running setup.py (path:/tmp/pip-cBn4y4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:21:12 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)) 04:21:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:21:12 INFO - Running setup.py (path:/tmp/pip-dLl9A8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:21:12 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)) 04:21:12 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:21:12 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:21:12 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)) 04:21:12 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:21:12 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:21:12 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:21:12 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 04:21:12 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 04:21:12 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 04:21:12 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 04:21:12 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 04:21:12 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 04:21:13 INFO - Downloading blessings-1.5.1.tar.gz 04:21:13 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 04:21:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:21:13 INFO - Installing collected packages: blessings 04:21:13 INFO - Running setup.py install for blessings 04:21:14 INFO - Successfully installed blessings 04:21:14 INFO - Cleaning up... 04:21:14 INFO - Return code: 0 04:21:14 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:21:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:21:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:21:14 INFO - Reading from file tmpfile_stdout 04:21:14 INFO - Current package versions: 04:21:14 INFO - argparse == 1.2.1 04:21:14 INFO - blessings == 1.5.1 04:21:14 INFO - blobuploader == 1.2.4 04:21:14 INFO - docopt == 0.6.1 04:21:14 INFO - manifestparser == 1.1 04:21:14 INFO - mozInstall == 1.12 04:21:14 INFO - mozcrash == 0.16 04:21:14 INFO - mozdebug == 0.1 04:21:14 INFO - mozdevice == 0.47 04:21:14 INFO - mozfile == 1.2 04:21:14 INFO - mozhttpd == 0.7 04:21:14 INFO - mozinfo == 0.9 04:21:14 INFO - mozleak == 0.1 04:21:14 INFO - mozlog == 3.1 04:21:14 INFO - moznetwork == 0.27 04:21:14 INFO - mozprocess == 0.22 04:21:14 INFO - mozprofile == 0.28 04:21:14 INFO - mozrunner == 6.11 04:21:14 INFO - mozscreenshot == 0.1 04:21:14 INFO - mozsystemmonitor == 0.0 04:21:14 INFO - moztest == 0.7 04:21:14 INFO - mozversion == 1.4 04:21:14 INFO - psutil == 3.1.1 04:21:14 INFO - requests == 1.2.3 04:21:14 INFO - wsgiref == 0.1.2 04:21:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:21:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:21:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:21:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:21:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:21:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:21:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:21:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 04:21:14 INFO - Using env: {'DISPLAY': ':0', 04:21:14 INFO - 'HOME': '/home/cltbld', 04:21:14 INFO - 'LANG': 'en_US.UTF-8', 04:21:14 INFO - 'LANGUAGE': 'en_US:en', 04:21:14 INFO - 'LOGNAME': 'cltbld', 04:21:14 INFO - 'MAIL': '/var/mail/cltbld', 04:21:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:21:14 INFO - 'MOZ_NO_REMOTE': '1', 04:21:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:21:14 INFO - 'NO_EM_RESTART': '1', 04:21:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:21:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:21:14 INFO - 'PWD': '/builds/slave/test', 04:21:14 INFO - 'SHELL': '/bin/bash', 04:21:14 INFO - 'SHLVL': '1', 04:21:14 INFO - 'TERM': 'linux', 04:21:14 INFO - 'TMOUT': '86400', 04:21:14 INFO - 'USER': 'cltbld', 04:21:14 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:21:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:21:14 INFO - '_': '/tools/buildbot/bin/python'} 04:21:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 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)) 04:21:14 INFO - Cleaning up... 04:21:14 INFO - Return code: 0 04:21:14 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:21:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:21:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:21:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:21:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:21:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:21:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:21:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 04:21:14 INFO - Using env: {'DISPLAY': ':0', 04:21:14 INFO - 'HOME': '/home/cltbld', 04:21:14 INFO - 'LANG': 'en_US.UTF-8', 04:21:14 INFO - 'LANGUAGE': 'en_US:en', 04:21:14 INFO - 'LOGNAME': 'cltbld', 04:21:14 INFO - 'MAIL': '/var/mail/cltbld', 04:21:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:21:14 INFO - 'MOZ_NO_REMOTE': '1', 04:21:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:21:14 INFO - 'NO_EM_RESTART': '1', 04:21:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:21:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:21:14 INFO - 'PWD': '/builds/slave/test', 04:21:14 INFO - 'SHELL': '/bin/bash', 04:21:14 INFO - 'SHLVL': '1', 04:21:14 INFO - 'TERM': 'linux', 04:21:14 INFO - 'TMOUT': '86400', 04:21:14 INFO - 'USER': 'cltbld', 04:21:14 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:21:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:21:14 INFO - '_': '/tools/buildbot/bin/python'} 04:21:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:21:14 INFO - Downloading/unpacking jsonschema 04:21:14 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 04:21:14 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 04:21:14 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 04:21:14 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 04:21:14 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 04:21:14 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 04:21:16 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:21:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 04:21:16 INFO - Downloading/unpacking functools32 (from jsonschema) 04:21:16 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 04:21:16 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 04:21:16 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 04:21:16 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 04:21:16 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 04:21:16 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 04:21:16 INFO - Downloading functools32-3.2.3-2.tar.gz 04:21:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 04:21:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:21:16 INFO - warning: no files found matching '*.txt' 04:21:16 INFO - no previously-included directories found matching 'build' 04:21:16 INFO - no previously-included directories found matching 'dist' 04:21:16 INFO - no previously-included directories found matching '.git*' 04:21:16 INFO - Installing collected packages: jsonschema, functools32 04:21:16 INFO - Running setup.py install for functools32 04:21:16 INFO - warning: no files found matching '*.txt' 04:21:16 INFO - no previously-included directories found matching 'build' 04:21:16 INFO - no previously-included directories found matching 'dist' 04:21:16 INFO - no previously-included directories found matching '.git*' 04:21:16 INFO - Successfully installed jsonschema functools32 04:21:16 INFO - Cleaning up... 04:21:16 INFO - Return code: 0 04:21:16 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:21:16 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')]} 04:21:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:21:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:16 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')]} 04:21:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:21:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:21:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fd246dfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fda8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, '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': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', '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 04:21:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 04:21:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 04:21:16 INFO - Using env: {'DISPLAY': ':0', 04:21:16 INFO - 'HOME': '/home/cltbld', 04:21:16 INFO - 'LANG': 'en_US.UTF-8', 04:21:16 INFO - 'LANGUAGE': 'en_US:en', 04:21:16 INFO - 'LOGNAME': 'cltbld', 04:21:16 INFO - 'MAIL': '/var/mail/cltbld', 04:21:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:21:16 INFO - 'MOZ_NO_REMOTE': '1', 04:21:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:21:16 INFO - 'NO_EM_RESTART': '1', 04:21:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:21:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:21:16 INFO - 'PWD': '/builds/slave/test', 04:21:16 INFO - 'SHELL': '/bin/bash', 04:21:16 INFO - 'SHLVL': '1', 04:21:16 INFO - 'TERM': 'linux', 04:21:16 INFO - 'TMOUT': '86400', 04:21:16 INFO - 'USER': 'cltbld', 04:21:16 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:21:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:21:16 INFO - '_': '/tools/buildbot/bin/python'} 04:21:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:21:17 INFO - Downloading/unpacking flake8 04:21:17 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 04:21:17 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 04:21:17 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 04:21:17 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 04:21:17 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 04:21:17 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 04:21:18 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:21:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 04:21:18 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:21:18 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 04:21:18 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 04:21:18 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 04:21:18 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 04:21:18 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 04:21:18 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 04:21:18 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:21:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 04:21:19 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:21:19 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 04:21:19 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 04:21:19 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 04:21:19 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 04:21:19 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 04:21:19 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 04:21:19 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 04:21:19 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:21:19 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 04:21:19 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 04:21:19 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 04:21:19 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 04:21:19 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 04:21:19 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 04:21:19 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 04:21:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:21:19 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:21:19 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:21:19 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:21:19 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:21:19 INFO - no previously-included directories found matching 'docs/_build' 04:21:19 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:21:19 INFO - Running setup.py install for pep8 04:21:19 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:21:19 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:21:19 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:21:19 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:21:19 INFO - no previously-included directories found matching 'docs/_build' 04:21:19 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:21:19 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:21:19 INFO - Cleaning up... 04:21:19 INFO - Return code: 0 04:21:19 INFO - Running post-action listener: _resource_record_post_action 04:21:19 INFO - Running post-action listener: _start_resource_monitoring 04:21:19 INFO - Starting resource monitoring. 04:21:19 INFO - ##### 04:21:19 INFO - ##### Running install step. 04:21:19 INFO - ##### 04:21:19 INFO - Running pre-action listener: _resource_record_pre_action 04:21:19 INFO - Running main action method: install 04:21:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:21:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:21:19 INFO - Reading from file tmpfile_stdout 04:21:19 INFO - Detecting whether we're running mozinstall >=1.0... 04:21:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:21:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:21:20 INFO - Reading from file tmpfile_stdout 04:21:20 INFO - Output received: 04:21:20 INFO - Usage: mozinstall [options] installer 04:21:20 INFO - Options: 04:21:20 INFO - -h, --help show this help message and exit 04:21:20 INFO - -d DEST, --destination=DEST 04:21:20 INFO - Directory to install application into. [default: 04:21:20 INFO - "/builds/slave/test"] 04:21:20 INFO - --app=APP Application being installed. [default: firefox] 04:21:20 INFO - mkdir: /builds/slave/test/build/application 04:21:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 04:21:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 04:21:35 INFO - Reading from file tmpfile_stdout 04:21:35 INFO - Output received: 04:21:35 INFO - /builds/slave/test/build/application/firefox/firefox 04:21:35 INFO - Running post-action listener: _resource_record_post_action 04:21:35 INFO - ##### 04:21:35 INFO - ##### Running run-tests step. 04:21:35 INFO - ##### 04:21:35 INFO - Running pre-action listener: _resource_record_pre_action 04:21:35 INFO - Running main action method: run_tests 04:21:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:21:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:21:35 INFO - Python 2.7.3 04:21:35 INFO - Return code: 0 04:21:35 INFO - grabbing minidump binary from tooltool 04:21:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:21:35 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 0x213c3d0>, '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 0x20a7ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a8360>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:21:35 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 04:21:35 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 04:21:35 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:21:35 INFO - Return code: 0 04:21:35 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:21:35 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:21:35 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:21:35 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:21:35 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:21:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:21:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:21:36 INFO - Return code: 0 04:21:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--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 04:21:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-011 --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 04:21:36 INFO - Using env: {'DISPLAY': ':0', 04:21:36 INFO - 'HOME': '/home/cltbld', 04:21:36 INFO - 'LANG': 'en_US.UTF-8', 04:21:36 INFO - 'LANGUAGE': 'en_US:en', 04:21:36 INFO - 'LOGNAME': 'cltbld', 04:21:36 INFO - 'MAIL': '/var/mail/cltbld', 04:21:36 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:21:36 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:21:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:21:36 INFO - 'MOZ_NO_REMOTE': '1', 04:21:36 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:21:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:21:36 INFO - 'NO_EM_RESTART': '1', 04:21:36 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:21:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:21:36 INFO - 'PWD': '/builds/slave/test', 04:21:36 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:21:36 INFO - 'SHELL': '/bin/bash', 04:21:36 INFO - 'SHLVL': '1', 04:21:36 INFO - 'TERM': 'linux', 04:21:36 INFO - 'TMOUT': '86400', 04:21:36 INFO - 'USER': 'cltbld', 04:21:36 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687', 04:21:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:21:36 INFO - '_': '/tools/buildbot/bin/python'} 04:21:36 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--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 04:21:36 INFO - mozversion application_buildid: 20160112025755 04:21:36 INFO - mozversion application_changeset: 314864749307f5450fd7ef9aaadd1af19cb75f82 04:21:36 INFO - mozversion application_display_name: Nightly 04:21:36 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:21:36 INFO - mozversion application_name: Firefox 04:21:36 INFO - mozversion application_remotingname: firefox 04:21:36 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 04:21:36 INFO - mozversion application_vendor: Mozilla 04:21:36 INFO - mozversion application_version: 46.0a1 04:21:36 INFO - mozversion platform_buildid: 20160112025755 04:21:36 INFO - mozversion platform_changeset: 314864749307f5450fd7ef9aaadd1af19cb75f82 04:21:36 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 04:21:36 INFO - mozversion platform_version: 46.0a1 04:21:36 INFO - using testdate: 1452601296 04:21:36 INFO - actual date: 1452601296 04:21:36 INFO - starting webserver on 'localhost:45896' 04:21:36 INFO - SUITE-START | Running 3 tests 04:21:36 INFO - TEST-START | dromaeo_css 04:21:36 INFO - operating with platform_type : linux_ 04:21:36 INFO - Initialising browser for dromaeo_css test... 04:21:36 INFO - TEST-INFO | started process 26481 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpl0D4o_/profile http://localhost:45896/getInfo.html) 04:21:41 INFO - PROCESS | 26481 | 04:21:41 INFO - PROCESS | 26481 | (process:26563): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:21:42 INFO - PROCESS | 26481 | __metrics Screen width/height:1600/1200 04:21:42 INFO - PROCESS | 26481 | colorDepth:24 04:21:42 INFO - PROCESS | 26481 | Browser inner width/height: 1024/697 04:21:42 INFO - PROCESS | 26481 | __metrics 04:21:42 INFO - PROCESS | 26481 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 04:21:44 INFO - TEST-INFO | 26481: exit 0 04:21:44 INFO - Browser initialized. 04:21:44 INFO - Running cycle 1/1 for dromaeo_css test... 04:21:44 INFO - TEST-INFO | started process 26612 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpl0D4o_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:21:45 INFO - PROCESS | 26612 | 04:21:45 INFO - PROCESS | 26612 | (process:26667): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:21:56 INFO - PROCESS | 26612 | RSS: Main: 149811200 04:21:56 INFO - PROCESS | 26612 | 04:22:45 INFO - PROCESS | 26612 | 1452601365760 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] 04:24:56 INFO - PROCESS | 26612 | Cycle 1(1): loaded http://localhost:45896/tests/dromaeo/cssquery-dojo.html (next: http://localhost:45896/tests/dromaeo/cssquery-ext.html) 04:24:57 INFO - PROCESS | 26612 | RSS: Main: 152002560 04:24:57 INFO - PROCESS | 26612 | 04:28:00 INFO - PROCESS | 26612 | Cycle 1(1): loaded http://localhost:45896/tests/dromaeo/cssquery-ext.html (next: http://localhost:45896/tests/dromaeo/cssquery-jquery.html) 04:28:00 INFO - PROCESS | 26612 | RSS: Main: 149921792 04:28:00 INFO - PROCESS | 26612 | 04:31:02 INFO - PROCESS | 26612 | Cycle 1(1): loaded http://localhost:45896/tests/dromaeo/cssquery-jquery.html (next: http://localhost:45896/tests/dromaeo/cssquery-mootools.html) 04:31:03 INFO - PROCESS | 26612 | RSS: Main: 151257088 04:31:03 INFO - PROCESS | 26612 | 04:34:04 INFO - PROCESS | 26612 | Cycle 1(1): loaded http://localhost:45896/tests/dromaeo/cssquery-mootools.html (next: http://localhost:45896/tests/dromaeo/cssquery-prototype.html) 04:34:05 INFO - PROCESS | 26612 | RSS: Main: 150339584 04:34:05 INFO - PROCESS | 26612 | 04:37:08 INFO - PROCESS | 26612 | Cycle 1(1): loaded http://localhost:45896/tests/dromaeo/cssquery-prototype.html (next: http://localhost:45896/tests/dromaeo/cssquery-yui.html) 04:37:08 INFO - PROCESS | 26612 | RSS: Main: 151416832 04:37:08 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | Cycle 1(1): loaded http://localhost:45896/tests/dromaeo/cssquery-yui.html (next: http://localhost:45896/tests/dromaeo/cssquery-dojo.html) 04:40:11 INFO - PROCESS | 26612 | RSS: Main: 153841664 04:40:11 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | __start_tp_report 04:40:11 INFO - PROCESS | 26612 | _x_x_mozilla_page_load 04:40:11 INFO - PROCESS | 26612 | _x_x_mozilla_page_load_details 04:40:11 INFO - PROCESS | 26612 | |i|pagename|runs| 04:40:11 INFO - PROCESS | 26612 | |0;dojo.html;2622.921312360629;2654.296611397981;2677.611746296787;2685.328667833043;2697.1099537152736;4360.345948107785;4494.662900282476;4554.2940844169125;4561.1789877821975;4592.977035114824;4484.4170257866435;4515.300128480083;4519.480259770119;4560.612347950429;4647.070585882829;4214.072903961123;4239.576042395766;4308.289132293168;4309.052008558112;4333.2416827055295;474.3116892263269;4209.684273679471;4217;4280.74315541067;4334.133173365324;4176.9582304177175;4236.68224883135;4241.766702831327;4254.298040823261;4289.721168124062;4248.830046798124;4266.0827921996915;4280.871573852789;4310.374995625648;4332.1119170569955;4102.876913692594;4162.1259535497275;4175.519815221258;4181.581841815824;4236.131593023453;4412.75729834859;4448.555144485558;4452.265376212921;4473.46318441789;4477.17172323118;4781.306710526954;4830.758462076882;4840.564349208588;4846.39420072491;4846.5880400166025;4803.3995750531185;4814.253790662453;4878.926816097762;4929.926051109236;4962.727050012248;4470.284754439274;4482.305242687388;4500.212462818994;4512.3908272382805;4521.864344069683;4853.95146048535;4905.2151655734915;4912.5016869855035;4924.409070911442;4954.380702412199;4718.221493453541;4759.048190361941;4759.524047595212;4783.210770222874;4814.9518504814505;4806.303086052503;4816.95183048172;4830.855074347775;4837.975810120927;4868.659193856467;4666.603338716247;4705.529447055335;4729.95270047302;4730.5032971538185;4790.377250957354;4803.927941080887;4812.374391329105;4813.78337974792;4830.903381932412;4885.438174609965;4109.773962432095;4111.8560850370095;4119.155573107506;4129.504459464823;4138.213739389506;3573.9642603574152;3618.5476815398074;3633.2370202257293;3656.213914008501;3680.3007428589017;4171.728837625545;4191.455110835572;4192.22443847883;4218.810153543098;4238.7032907696785;4809.95190048102;4840.201366774443;4841.12859685253;4846.39420072491;4878.853634390974;4107.260693075215;4173.520045194841;4181.51912530063;4204.26425375558;4261.637760790306;4299.6775241856985;4307.246231909403;4316.417283666728;4325.7188282762145;4368.104538569585;4536.500984891659;4540.069285796338;4547.522510136454;4586.610138138229;4589.609883159968;4714.198586240279;4803.303520989507;4808.014357056865;4868.3427737255015;4945.752712364296;4577.610903073276;4580.816767329269;4587.541245875385;4588.770561471846;4605.171069207575;4742.217534106834;4746.121967436035;4767.809287628456;4779.952200477951;4815.398075240595;4682.578567928903;4765.666403351732;4844.563989240985;4877.024595080927;4929.926051109308;4625.352450656844;4672.415948006499;4673.299005149255;4695.5304469552775;4709.5290470954005;4588.839390621312;4649.093426781745;4673.696209746356;4690.319903614025;4732.929006064981;4521.208788462071;4545.363649089064;4565.33802598628;4571.748553829439;4638.953610463852;4691.859244222679;4738.644601654959;4746.4541577719;4748.8100475981955;4778.665493415428;4563.452385713736;4651.279051746985;4662.953370466252;4665.32352808834;4701.600363969101 04:40:11 INFO - PROCESS | 26612 | |1;ext.html;488.49684824630646;525.8133362656255;546.721172202177;566.5411017076169;579.4350508254453;31628.525572116407;32102.35795284093;32153.839230803813;32316.353672926587;32343.67656323439;36203.094922626944;36745.632543674554;36785;36868.81565592168;36989.63010369895;7522.172561018284;7698.653560589759;7707.884381734279;7710.730124445646;7712.228777122299;7577.5453472791805;7731.652075656609;7744;7896.447248692594;7906.209379062106;7719.768406947801;7757.224277572254;7771.067471903351;7803.843923121534;7810.687572497093;7824.256695613907;7864.252895974902;7921.168277330912;7926.682932682744;7942.761717148494;7493.925060749377;7528.623568821592;7561.357284630813;7568.091828980502;7580.469367144302;36260.456093158624;36270.81864590687;36361.81819090914;36404.81797591021;36473.27053458943;2311.976880231193;2805.2425845021935;2888.364559796841;2933.208033830875;3192.8722851085927;24106.7589324108;24227.372795409112;24360.02559897602;24534.754652453426;24620.876895615587;3322.8504717287537;3429.5198672185916;3459.60214575322;3490;3499.5450591423205;173940;175147;175919;176467;297758;42545.36181957273;55734.44265557292;57456;57505.71247143738;57543.71228143916;53456.73271633695;54509.45490545044;54510.45489545133;54713.452865471634;54759.45240547623;13122.737545249232;13201.47194112244;13265.933670331586;13315;13332.600021999162;9768;9913.603455861685;9944.751381215383;9953.651622193189;9961.302708810459;19012.545971205443;19429.80570194308;19434;19494.122764475633;19519.902400487907;6847.554908930903;6991.650417479105;7004.3696067354185;7033.824154396181;7035.824104397431;839.6347588798892;845.1337379186383;913.8263729891432;987.5555999800118;1020.6937918624383;25521.744782551938;25894.611580826302;26194.86902565475;26456.206313810617;26611.733882661312;872.389327470773;880.3969281042506;986.5757724178528;989.9803202701229;1017.7150397888603;12665.303408312631;12804.42380092898;12857.485700572059;13104.868951310556;13163.473461061642;260700;262410;263288;263373;263416;43755.78122109369;43939;43962.34056489155;44104.558954410684;44128.558714413084;1185.697647099984;1207.4385410784027;1223.1437993404652;1223.1988047828509;1225.1913736933582;24396.390090247885;25386.619200712372;25685.61471577965;25804;25871.482570348864;39515.80242098771;39541.60458395379;39835.211535192255;39898.601013989486;39994.20011599694;252521;252618;252837;253432;253551;25573.488530229664;28400.005999790734;29107.417851643273;29319;29329;33536.49695254622;33763.83118084394;33799.83100084484;34650.30699386049;34651.30697386088;28623.713762862106;29219.85390073036;29267.414651707273;29301.26746831261;29691.109266722033;28602.42795144127;28659.8567007172;29059.7094029057;29098.127056188347;31602.893898713435;29845.10464686063;30021.399572008875;30028.84985575058;30186.24534386658;30221.69778302189;28100.71899280981;29103.85448072746;30652.84673576618;30709.69290307068;30987.535186971763;21670.67493987623;21878.249740021078;22633.2078377256;23166.768332317137;23504.6474302889 04:40:11 INFO - PROCESS | 26612 | |2;jquery.html;342.43840102232326;344.1173390253998;344.78450968144904;345.31972015130185;345.94810778383254;14109.365078571464;14228.857711422883;14784.926075369609;15106;15506.604405603493;9466.479343636114;9699.806003879918;11028.889711102907;14262.286885655702;14330.498432554863;4357.891052723683;4469.82120715171;4535.523770004152;4560.680752347337;5048.469910659383;4940.308356830046;5037.59699224063;5039;5044.142495775709;5054.21659642756;3305.4711246200613;3500.7724497907557;5002.59979201663;5022.899542009158;5122.385313762354;5156.407013193493;5176;5176.378834539842;5179.223116532513;5206.609504287175;4897.632677549198;5179.585633149377;5179.766910489037;5194.584433245332;5220;11665.475053622607;11778.646640600795;16712.41506547265;18394.908025459787;18444.89330640166;1625.0980705708328;1702.8126906040325;1768.5136587438558;1799.1813724755204;1860.7767067951797;8163.632636531311;8542.914570854275;8681.04508504064;8914.331425143075;9089.409188402733;1690;1753.9123043847756;1782.4474412932032;1794.4347530527973;1827.4060930197738;49330.01339973216;49983.500164998615;49992.25011624829;50651.493485065046;51540.48459515432;9681.661141860142;9690.806183876424;9723.076307750753;9725.465099419458;9778.706638800848;12276.447559859827;12322.81515777264;12399.628011159679;12421.627351179479;12430.875691243153;6362.77730279438;6495.4803615710625;6510.446612037935;6608.603483790988;6621.172353455818;6058.757649693963;6081.513478921675;6105.084237364431;6239.0953311770445;6247;4135.359019352005;4167.874963751093;4175.269327867611;4182.351735481006;4226;1757.349780581193;1791.3909270847973;1807.954801129956;1818.5090025693253;1828.1042289278157;724.5616402076668;840.684743221292;845.2097289034772;893.9061398553058;924.9686599441574;12573.937130314473;13563.932180339036;14222.502212422516;14308.856911430752;15277.541673749805;834.8580741273998;848.1264297773304;863.8099618084011;882.4264228251687;886.0740526150189;8690.608922598498;8846.646134154691;8922;9084.364814333483;9186.94350149728;442120;445690;456387;458223;460967;62844;66655;67090.3290967084;67305.32694673089;67986.66006669935;1077.9137668986618;1081.5295346524288;1085.7285678580513;1095.424901926479;1097.078454098545;13838.65403364924;13893.95795315335;13964.581062568139;14124;14193.858061419254;31333.686663133987;31553.21116972094;31623.20941976377;32186.35627287488;32552.674473254963;41270;41512.79243603763;41554;41623.791881041616;41857.58142418659;4832.540908613676;6860.142482189726;6879.793606191823;7038.964805175941;7119.181294151032;8064.919350806652;9445.291603129655;9568.856467153137;9699.757506062404;9722.222222222064;7715.807104822425;8173.264406203471;8192.83614327722;8220.424570280262;8259.669613215645;9044.457332560067;9060.365774395728;9114.225290850352;9399.671011514563;9450.243980481682;8488.448250863674;8771.210591046836;8871.423357481743;8916.643334266557;9095.226905713089;6825.180978282439;6948.33990770876;7011.719531218694;7042.718291268497;7148.356647901714;7833.725819596287;8119.18808119207;8744.737657870273;8794.120587941155;8932.50871202064 04:40:11 INFO - PROCESS | 26612 | |3;mootools.html;1401.7266633006564;1415.3347926474553;1538.1693885301938;1696.635223426963;1717.7509261157124;6398.264199617045;6515.120458738069;7474.813129671754;7659.080910290766;7675.769726908187;7210.567365958046;7422;7476.289752473506;7483.625818709056;7483.775486735407;2173.1307477009245;2198.5492973940304;2203.5813195492806;2215.3796936857707;2217.2572188316935;2166.3392665237097;2187.55155193185;2187.726534183227;2194.1333173396497;2199.2192771566106;2161.5352699169675;2164.6103701333755;2170.392290158758;2172.7827217278223;2233.0955962834996;2185.4208634711813;2195.6157672407426;2196.374033400481;2197.4176843136584;2200.273909609833;2140.047678782942;2170.1319472211085;2172.902219400131;2181.792729690693;2184.3010236724253;7630.160682324939;7702.961485192538;7718.729844455417;7729.111152217511;7742.961285193594;4162.500499939996;4218.029853133797;4255.2978758504805;4261.488621365425;4283.2932566126865;2604.7785938195275;2621.685397752263;2667.1331817159503;2687.6371689821817;2688.4623075384807;831.7421599304236;839.2824135364236;843.2284459719349;874.5583480342386;878.9824203515958;9582.856257156149;9594.712158635251;9598.856017159747;9624;9641.614335426575;3921.7646941183048;3971.960280397159;3989.92020159601;3994.0813612868624;4028.9395659064553;8353.457025293337;8361.749147525585;8393.160683931557;8396.328293736486;8401.15988401155;4284.378765079108;4288.871333859989;4289.506706728704;4299.591538803808;4301.16127355169;3870.574236833946;3897.162110146332;3980.2636512245326;4103.179364127186;4116.91766164675;3284.3759685659647;3294.077658255644;3327.284633803744;3340.465525515906;3352.1452029732263;971.1793534463367;973.6543527047937;976.8192884316425;981.9018098190123;1000.2847963705985;1123.528118190362;1129.9548018079186;1136.9829452558217;1144.9771004580027;1158.0561842098662;6715.5299129060495;7197.640117994079;7328.120625524971;7364.926350736531;7365.373943214887;955.7419496735843;980.2550061952967;991.9256055795844;1038.8597539332245;1070.2401295080424;5461.1262198048125;5499.862503437446;5649.350324712628;5652.293463317085;5654.208410822488;8477.74566762998;8727.083656216006;8754.824903501894;8791.956040219886;8852.690155844515;8753.431026983226;8897.377183597215;8920.107989201158;8923.866142007875;8938.68714594986;7033.824154396181;7123.287671232835;7152.427805775629;7187.425005999507;7195.92804071963;6726.8990965136545;6783.457323414016;6946.756863509753;6950.756723514653;6955.443564514725;8108.554029528433;8136.75589732309;8264.297534709376;8284.627191776504;8322;8333.208345207195;8377.371697122619;8478;8517.616707248064;8591.269742071994;5699.971500142473;5824.213731146241;6625.072489851328;6772.11962444879;6807.183138023469;6471.935280647133;6578.506612004215;6593.703283352164;6609.735610575523;6618.602883826986;6099.542534309856;6214.720337584729;6242;6305.8108256752375;6348.93651063502;6118.816435506942;6150.7847225346895;6211.440970312694;6222.28443728977;6339.049142628458;6236.064590311489;6246.718897649525;6264.874702506016;6397.744090236339;6405.967970160119;5978.252718410199;5982.042873140451;6040.426159514839;6041.879162416815;6058.394160583906;5936.7922122725495;5950.583459157818;5955.851103722442;6007.249093863267;6011.128386383863 04:40:11 INFO - PROCESS | 26612 | |4;prototype.html;316.08966177409064;319.4808436291027;324.72207464635574;327.089056976321;328.51215944322684;5592.384837667853;5625.887482250352;5660.632058916168;5669.177969194464;5767.884642307151;5578;5615.9157612635845;5625.46558076982;5664.858378540539;5681.375048744635;4297.376880352347;4301.268784306675;4304.741715497064;4305.67707421943;4309.6336811371075;4296.248156572603;4317.956820431787;4318.179545886287;4321.200577893084;4324.853913712868;4164.10471748574;4218.641415479673;4259.16946195492;4266.360045993095;4268.59448352406;4202.075543380467;4244.596763307481;4254.7872606369865;4257.233697934371;4271.252530807112;3673.9712880393267;3678.5401824771902;3678.9331093982983;3680.4479328100733;3684.1158122050783;5364.973175134139;5381.3811411687375;5384.434634363413;5390.299261096072;5393.703346315951;4717.956878033237;4900.534449227318;4910.8281210157475;4912.017596480682;4917.606591472673;5670.744816483269;5829.795957141479;5852.571182959067;5864.325602555718;5872.354041055481;3973.304671682444;3973.9006524836823;3998.4402183694306;4001.919961600781;4002.419649150857;6160.722767475474;6184.350643182491;6220.813375598785;6221.937780622181;6222.719977601018;4049.6152865477734;4192.853250136231;4198.958010419857;4199.832006719758;4207.495100587949;4241.533431322552;4246.7027308088755;4255.085156691326;4310.547392523803;4310.568943105664;4841.636877234221;4874.8781280467565;4893.975530122327;4894.510548945077;4902.803887844446;5802.535797136219;5858.648481091148;5885.323187833368;5891.3814049525035;5900.4099590041515;1448.7826825975976;1493.4101030093052;1502.278906125066;1509.1473317575535;1517.415794918942;936.6253498600478;946.5172761891347;967.3083745122271;990.5245482168599;994.1301361308855;5024.547790698854;5026.472220416877;5038.2190760432195;5041.067402530543;5041.546260836542;6015.54883383748;6017.976943919544;6025.9096113558335;6057.727402266909;6062.151298818169;5038.899222015539;5054.342935418372;5060.165072762953;5061.6962982221185;5076.74616269185;3217.9195520111716;3250.138713240993;3262.8042317461027;3270.640229574745;3281.8523166457567;5652.293463317085;5665.688387138664;5667.943320566742;5680.573956953162;5685.77256909719;6202.4417802398;6218.22272215973;6250.9062364064575;6252.843678908063;6262.718177682015;5555.50000499957;5617.606767526234;5673.092305231144;5681.545476361881;5687.601867869293;5975.760969561169;6054.606450580698;6060.333363329942;6061.969690151521;6075.544334174866;5898.793542226002;5904.114382842608;5905.379935106752;5908.172855800278;5913.46778789911;5652.519535839499;5657.8019769307875;5665.065264231355;5667.404922483245;5681.857953551029;4126;4139.958600414077;4163.375493675972;4299.419578357007;4299.95700043008;6003.529135361864;6071.089336599545;6078.878422431615;6086.908696369469;6092.878142437038;5863.970680146572;5903.852403689771;5907.2911250650195;5908.468237858613;5912.586118971631;5851.912221316768;5875.911861321998;5947;5968.4926781224085;5969.791057312973;5599.300087489064;5737.971310143423;5742.7702891883855;5755.395683453345;5786.855328616818;5976.760929562769;5979.5814292999075;6002.339742628395;6005.849853753691;6021.939780602138;5798.33319168301;5842;5853.0635098384055;5853.356130825691;5877.147813566923 04:40:11 INFO - PROCESS | 26612 | |5;yui.html;627.5324882962191;691.6023286610197;703.7572037647013;756.500709531709;764.4304992780379;11431.142664300169;11622.593209237679;11630.302181869094;11648.825267620981;12964.286964216964;13446.126001809875;13613.727725445486;13640.386182621782;13652.317384130803;13674.931625341884;756.4666909828585;762.1273641680273;769.2384539306074;773.0645918438696;777;768.4851149729667;772.0735117858565;773.5899973014311;774.8915151878741;775.8603451378749;802.5224991130298;805.7743831727125;805.9717909873156;807.5840941914919;808.4946908182386;784.3019712455919;787.7636708987338;789.6130895861015;789.8064974081358;791.3708601661692;595.1043679262725;595.5830918357167;596.1951365656373;596.6479776931587;596.785157343356;12569;12680.239185648798;12681.682957926034;12688.111832171751;12692.238465692088;11011.174161937806;11284.210105292634;11339.319640821577;11417.31496110236;11483;9099.361185256268;9644.083812037845;9654.806903861954;9707.805843883083;9710.417374957526;3967.2462232175794;3995.960040399617;4003.5796241394523;4026.4362989181536;4116.135611521584;41119.1776164478;41285.380719289235;41356;41487.58512414897;41490;9043.23132533742;9202.723918282461;9363.067129457237;9402.576884040234;9465.574049167804;15933.681326373408;15995.12026838535;16045.358185672443;16060.919695401448;16074.919625401799;6214.192155019909;6250.937490625127;6303.527235457359;6316.747330106744;6410.391012853772;3552.467129930531;3604.711623070148;3628.32875917956;3631.4371272452813;3636.760662636884;2586.1465716313573;2616.3851494898686;2620.489004644076;2622.960655590168;2627.238100950741;457.9015511665008;473.9810407583727;475.75974133062584;489.6670264220293;492.2173743747387;565.2425749495613;568.5877738639454;590.8109404990362;595.2589026661834;627.4071002902305;7330;7387.6675549600395;7635.809104772314;7773.222677732295;7816.804579885548;456.9337446070301;470.3978906999047;503.41855157293384;614.9822044516333;620.8696173803462;3613.801240931774;3683.4474828775897;3762.360398732222;3807.8286477108595;3872.6901847852105;45510.772446137555;45917.540824592;48263;48514;51121;40726;41084.38373424401;41169.58830411718;41422.79288603598;41816.37275440871;36481;37129;37848.62151378506;37956;37972.05069873275;7558.9244107558225;7858.489198202098;7907.604619769104;7922.405819563441;8357.164283571838;26915.461690766468;27570.86214568914;28032.71967280301;28283.858580706965;28301.71698282991;37050;37194;37239.813800930824;37641.43537846989;37721.05697357588;9948.204143668634;9953.303268771117;10085.142762864945;10116.190704743456;10158.949205253926;10784.406857622906;10797.24419290642;10985.340879547253;10996.607883200082;11340.6030788922;10240.795184096425;10341.534630941474;10459.94770026145;10489.632862849763;10563.471826408802;10323.845142323022;10441.183061837293;10465.790684186426;10892.836607450736;11090.944545277222;9632.084951929555;9795.06946840049;9814.607415703293;9846.409215447096;9948.204143668634;8267.751967440987;8568.785780355542;8576.185262400062;8727.738167854974;8771.38600297973;8664.436811607226;8724.738257852274;8968.910310896808;9107.499087550248;9109.817803644022 04:40:11 INFO - PROCESS | 26612 | __end_tp_report 04:40:11 INFO - PROCESS | 26612 | __start_cc_report 04:40:11 INFO - PROCESS | 26612 | _x_x_mozilla_cycle_collect,331 04:40:11 INFO - PROCESS | 26612 | __end_cc_report 04:40:11 INFO - PROCESS | 26612 | __startTimestamp1452602411692__endTimestamp 04:40:11 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | ------- Summary: start ------- 04:40:11 INFO - PROCESS | 26612 | Number of tests: 6 04:40:11 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | [#0] dojo.html Cycles:165 Average:4457.73 Median:4586.61 stddev:533.80 (11.6%) stddev-sans-first:515.67 04:40:11 INFO - PROCESS | 26612 | Values: 2622.9 2654.3 2677.6 2685.3 2697.1 4360.3 4494.7 4554.3 4561.2 4593.0 4484.4 4515.3 4519.5 4560.6 4647.1 4214.1 4239.6 4308.3 4309.1 4333.2 474.3 4209.7 4217.0 4280.7 4334.1 4177.0 4236.7 4241.8 4254.3 4289.7 4248.8 4266.1 4280.9 4310.4 4332.1 4102.9 4162.1 4175.5 4181.6 4236.1 4412.8 4448.6 4452.3 4473.5 4477.2 4781.3 4830.8 4840.6 4846.4 4846.6 4803.4 4814.3 4878.9 4929.9 4962.7 4470.3 4482.3 4500.2 4512.4 4521.9 4854.0 4905.2 4912.5 4924.4 4954.4 4718.2 4759.0 4759.5 4783.2 4815.0 4806.3 4817.0 4830.9 4838.0 4868.7 4666.6 4705.5 4730.0 4730.5 4790.4 4803.9 4812.4 4813.8 4830.9 4885.4 4109.8 4111.9 4119.2 4129.5 4138.2 3574.0 3618.5 3633.2 3656.2 3680.3 4171.7 4191.5 4192.2 4218.8 4238.7 4810.0 4840.2 4841.1 4846.4 4878.9 4107.3 4173.5 4181.5 4204.3 4261.6 4299.7 4307.2 4316.4 4325.7 4368.1 4536.5 4540.1 4547.5 4586.6 4589.6 4714.2 4803.3 4808.0 4868.3 4945.8 4577.6 4580.8 4587.5 4588.8 4605.2 4742.2 4746.1 4767.8 4780.0 4815.4 4682.6 4765.7 4844.6 4877.0 4929.9 4625.4 4672.4 4673.3 4695.5 4709.5 4588.8 4649.1 4673.7 4690.3 4732.9 4521.2 4545.4 4565.3 4571.7 4639.0 4691.9 4738.6 4746.5 4748.8 4778.7 4563.5 4651.3 4663.0 4665.3 4701.6 04:40:11 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | [#1] ext.html Cycles:180 Average:38984.75 Median:32330.02 stddev:63169.68 (195.4%) stddev-sans-first:63280.75 04:40:11 INFO - PROCESS | 26612 | Values: 488.5 525.8 546.7 566.5 579.4 31628.5 32102.4 32153.8 32316.4 32343.7 36203.1 36745.6 36785.0 36868.8 36989.6 7522.2 7698.7 7707.9 7710.7 7712.2 7577.5 7731.7 7744.0 7896.4 7906.2 7719.8 7757.2 7771.1 7803.8 7810.7 7824.3 7864.3 7921.2 7926.7 7942.8 7493.9 7528.6 7561.4 7568.1 7580.5 36260.5 36270.8 36361.8 36404.8 36473.3 2312.0 2805.2 2888.4 2933.2 3192.9 24106.8 24227.4 24360.0 24534.8 24620.9 3322.9 3429.5 3459.6 3490.0 3499.5 173940.0 175147.0 175919.0 176467.0 297758.0 42545.4 55734.4 57456.0 57505.7 57543.7 53456.7 54509.5 54510.5 54713.5 54759.5 13122.7 13201.5 13265.9 13315.0 13332.6 9768.0 9913.6 9944.8 9953.7 9961.3 19012.5 19429.8 19434.0 19494.1 19519.9 6847.6 6991.7 7004.4 7033.8 7035.8 839.6 845.1 913.8 987.6 1020.7 25521.7 25894.6 26194.9 26456.2 26611.7 872.4 880.4 986.6 990.0 1017.7 12665.3 12804.4 12857.5 13104.9 13163.5 260700.0 262410.0 263288.0 263373.0 263416.0 43755.8 43939.0 43962.3 44104.6 44128.6 1185.7 1207.4 1223.1 1223.2 1225.2 24396.4 25386.6 25685.6 25804.0 25871.5 39515.8 39541.6 39835.2 39898.6 39994.2 252521.0 252618.0 252837.0 253432.0 253551.0 25573.5 28400.0 29107.4 29319.0 29329.0 33536.5 33763.8 33799.8 34650.3 34651.3 28623.7 29219.9 29267.4 29301.3 29691.1 28602.4 28659.9 29059.7 29098.1 31602.9 29845.1 30021.4 30028.8 30186.2 30221.7 28100.7 29103.9 30652.8 30709.7 30987.5 21670.7 21878.2 22633.2 23166.8 23504.6 04:40:11 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | [#2] jquery.html Cycles:180 Average:23874.62 Median:5051.34 stddev:74038.74 (1465.7%) stddev-sans-first:74225.35 04:40:11 INFO - PROCESS | 26612 | Values: 342.4 344.1 344.8 345.3 345.9 14109.4 14228.9 14784.9 15106.0 15506.6 9466.5 9699.8 11028.9 14262.3 14330.5 4357.9 4469.8 4535.5 4560.7 5048.5 4940.3 5037.6 5039.0 5044.1 5054.2 3305.5 3500.8 5002.6 5022.9 5122.4 5156.4 5176.0 5176.4 5179.2 5206.6 4897.6 5179.6 5179.8 5194.6 5220.0 11665.5 11778.6 16712.4 18394.9 18444.9 1625.1 1702.8 1768.5 1799.2 1860.8 8163.6 8542.9 8681.0 8914.3 9089.4 1690.0 1753.9 1782.4 1794.4 1827.4 49330.0 49983.5 49992.3 50651.5 51540.5 9681.7 9690.8 9723.1 9725.5 9778.7 12276.4 12322.8 12399.6 12421.6 12430.9 6362.8 6495.5 6510.4 6608.6 6621.2 6058.8 6081.5 6105.1 6239.1 6247.0 4135.4 4167.9 4175.3 4182.4 4226.0 1757.3 1791.4 1808.0 1818.5 1828.1 724.6 840.7 845.2 893.9 925.0 12573.9 13563.9 14222.5 14308.9 15277.5 834.9 848.1 863.8 882.4 886.1 8690.6 8846.6 8922.0 9084.4 9186.9 442120.0 445690.0 456387.0 458223.0 460967.0 62844.0 66655.0 67090.3 67305.3 67986.7 1077.9 1081.5 1085.7 1095.4 1097.1 13838.7 13894.0 13964.6 14124.0 14193.9 31333.7 31553.2 31623.2 32186.4 32552.7 41270.0 41512.8 41554.0 41623.8 41857.6 4832.5 6860.1 6879.8 7039.0 7119.2 8064.9 9445.3 9568.9 9699.8 9722.2 7715.8 8173.3 8192.8 8220.4 8259.7 9044.5 9060.4 9114.2 9399.7 9450.2 8488.4 8771.2 8871.4 8916.6 9095.2 6825.2 6948.3 7011.7 7042.7 7148.4 7833.7 8119.2 8744.7 8794.1 8932.5 04:40:11 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | [#3] mootools.html Cycles:180 Average:5109.80 Median:6229.17 stddev:2660.38 (42.7%) stddev-sans-first:2653.24 04:40:11 INFO - PROCESS | 26612 | Values: 1401.7 1415.3 1538.2 1696.6 1717.8 6398.3 6515.1 7474.8 7659.1 7675.8 7210.6 7422.0 7476.3 7483.6 7483.8 2173.1 2198.5 2203.6 2215.4 2217.3 2166.3 2187.6 2187.7 2194.1 2199.2 2161.5 2164.6 2170.4 2172.8 2233.1 2185.4 2195.6 2196.4 2197.4 2200.3 2140.0 2170.1 2172.9 2181.8 2184.3 7630.2 7703.0 7718.7 7729.1 7743.0 4162.5 4218.0 4255.3 4261.5 4283.3 2604.8 2621.7 2667.1 2687.6 2688.5 831.7 839.3 843.2 874.6 879.0 9582.9 9594.7 9598.9 9624.0 9641.6 3921.8 3972.0 3989.9 3994.1 4028.9 8353.5 8361.7 8393.2 8396.3 8401.2 4284.4 4288.9 4289.5 4299.6 4301.2 3870.6 3897.2 3980.3 4103.2 4116.9 3284.4 3294.1 3327.3 3340.5 3352.1 971.2 973.7 976.8 981.9 1000.3 1123.5 1130.0 1137.0 1145.0 1158.1 6715.5 7197.6 7328.1 7364.9 7365.4 955.7 980.3 991.9 1038.9 1070.2 5461.1 5499.9 5649.4 5652.3 5654.2 8477.7 8727.1 8754.8 8792.0 8852.7 8753.4 8897.4 8920.1 8923.9 8938.7 7033.8 7123.3 7152.4 7187.4 7195.9 6726.9 6783.5 6946.8 6950.8 6955.4 8108.6 8136.8 8264.3 8284.6 8322.0 8333.2 8377.4 8478.0 8517.6 8591.3 5700.0 5824.2 6625.1 6772.1 6807.2 6471.9 6578.5 6593.7 6609.7 6618.6 6099.5 6214.7 6242.0 6305.8 6348.9 6118.8 6150.8 6211.4 6222.3 6339.0 6236.1 6246.7 6264.9 6397.7 6406.0 5978.3 5982.0 6040.4 6041.9 6058.4 5936.8 5950.6 5955.9 6007.2 6011.1 04:40:11 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | [#4] prototype.html Cycles:180 Average:4848.08 Median:5621.54 stddev:1439.15 (25.6%) stddev-sans-first:1402.41 04:40:11 INFO - PROCESS | 26612 | Values: 316.1 319.5 324.7 327.1 328.5 5592.4 5625.9 5660.6 5669.2 5767.9 5578.0 5615.9 5625.5 5664.9 5681.4 4297.4 4301.3 4304.7 4305.7 4309.6 4296.2 4318.0 4318.2 4321.2 4324.9 4164.1 4218.6 4259.2 4266.4 4268.6 4202.1 4244.6 4254.8 4257.2 4271.3 3674.0 3678.5 3678.9 3680.4 3684.1 5365.0 5381.4 5384.4 5390.3 5393.7 4718.0 4900.5 4910.8 4912.0 4917.6 5670.7 5829.8 5852.6 5864.3 5872.4 3973.3 3973.9 3998.4 4001.9 4002.4 6160.7 6184.4 6220.8 6221.9 6222.7 4049.6 4192.9 4199.0 4199.8 4207.5 4241.5 4246.7 4255.1 4310.5 4310.6 4841.6 4874.9 4894.0 4894.5 4902.8 5802.5 5858.6 5885.3 5891.4 5900.4 1448.8 1493.4 1502.3 1509.1 1517.4 936.6 946.5 967.3 990.5 994.1 5024.5 5026.5 5038.2 5041.1 5041.5 6015.5 6018.0 6025.9 6057.7 6062.2 5038.9 5054.3 5060.2 5061.7 5076.7 3217.9 3250.1 3262.8 3270.6 3281.9 5652.3 5665.7 5667.9 5680.6 5685.8 6202.4 6218.2 6250.9 6252.8 6262.7 5555.5 5617.6 5673.1 5681.5 5687.6 5975.8 6054.6 6060.3 6062.0 6075.5 5898.8 5904.1 5905.4 5908.2 5913.5 5652.5 5657.8 5665.1 5667.4 5681.9 4126.0 4140.0 4163.4 4299.4 4300.0 6003.5 6071.1 6078.9 6086.9 6092.9 5864.0 5903.9 5907.3 5908.5 5912.6 5851.9 5875.9 5947.0 5968.5 5969.8 5599.3 5738.0 5742.8 5755.4 5786.9 5976.8 5979.6 6002.3 6005.8 6021.9 5798.3 5842.0 5853.1 5853.4 5877.1 04:40:11 INFO - PROCESS | 26612 | 04:40:11 INFO - PROCESS | 26612 | [#5] yui.html Cycles:180 Average:11907.88 Median:23187.72 stddev:13089.02 (56.4%) stddev-sans-first:13098.33 04:40:11 INFO - PROCESS | 26612 | Values: 627.5 691.6 703.8 756.5 764.4 11431.1 11622.6 11630.3 11648.8 12964.3 13446.1 13613.7 13640.4 13652.3 13674.9 756.5 762.1 769.2 773.1 777.0 768.5 772.1 773.6 774.9 775.9 802.5 805.8 806.0 807.6 808.5 784.3 787.8 789.6 789.8 791.4 595.1 595.6 596.2 596.6 596.8 12569.0 12680.2 12681.7 12688.1 12692.2 11011.2 11284.2 11339.3 11417.3 11483.0 9099.4 9644.1 9654.8 9707.8 9710.4 3967.2 3996.0 4003.6 4026.4 4116.1 41119.2 41285.4 41356.0 41487.6 41490.0 9043.2 9202.7 9363.1 9402.6 9465.6 15933.7 15995.1 16045.4 16060.9 16074.9 6214.2 6250.9 6303.5 6316.7 6410.4 3552.5 3604.7 3628.3 3631.4 3636.8 2586.1 2616.4 2620.5 2623.0 2627.2 457.9 474.0 475.8 489.7 492.2 565.2 568.6 590.8 595.3 627.4 7330.0 7387.7 7635.8 7773.2 7816.8 456.9 470.4 503.4 615.0 620.9 3613.8 3683.4 3762.4 3807.8 3872.7 45510.8 45917.5 48263.0 48514.0 51121.0 40726.0 41084.4 41169.6 41422.8 41816.4 36481.0 37129.0 37848.6 37956.0 37972.1 7558.9 7858.5 7907.6 7922.4 8357.2 26915.5 27570.9 28032.7 28283.9 28301.7 37050.0 37194.0 37239.8 37641.4 37721.1 9948.2 9953.3 10085.1 10116.2 10158.9 10784.4 10797.2 10985.3 10996.6 11340.6 10240.8 10341.5 10459.9 10489.6 10563.5 10323.8 10441.2 10465.8 10892.8 11090.9 9632.1 9795.1 9814.6 9846.4 9948.2 8267.8 8568.8 8576.2 8727.7 8771.4 8664.4 8724.7 8968.9 9107.5 9109.8 04:40:11 INFO - PROCESS | 26612 | -------- Summary: end -------- 04:40:11 INFO - PROCESS | 26612 | 04:40:12 INFO - TEST-INFO | 26612: exit 0 04:40:12 INFO - TEST-OK | dromaeo_css | took 1115571ms 04:40:12 INFO - TEST-START | kraken 04:40:12 INFO - operating with platform_type : linux_ 04:40:12 INFO - Initialising browser for kraken test... 04:40:12 INFO - TEST-INFO | started process 26846 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS8VUtO/profile http://localhost:45896/getInfo.html) 04:40:16 INFO - PROCESS | 26846 | 04:40:16 INFO - PROCESS | 26846 | (process:26917): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:40:17 INFO - PROCESS | 26846 | __metrics Screen width/height:1600/1200 04:40:17 INFO - PROCESS | 26846 | colorDepth:24 04:40:17 INFO - PROCESS | 26846 | Browser inner width/height: 1024/697 04:40:17 INFO - PROCESS | 26846 | __metrics 04:40:18 INFO - PROCESS | 26846 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 04:40:19 INFO - TEST-INFO | 26846: exit 0 04:40:19 INFO - Browser initialized. 04:40:19 INFO - Running cycle 1/1 for kraken test... 04:40:19 INFO - TEST-INFO | started process 26966 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS8VUtO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:40:20 INFO - PROCESS | 26966 | 04:40:20 INFO - PROCESS | 26966 | (process:27022): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:40:31 INFO - PROCESS | 26966 | RSS: Main: 149958656 04:40:31 INFO - PROCESS | 26966 | 04:40:33 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:45896/tests/kraken/driver.html?testName=audio-beat-detection) 04:40:34 INFO - PROCESS | 26966 | RSS: Main: 150294528 04:40:34 INFO - PROCESS | 26966 | 04:40:37 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:45896/tests/kraken/driver.html?testName=audio-dft) 04:40:37 INFO - PROCESS | 26966 | RSS: Main: 151293952 04:40:37 INFO - PROCESS | 26966 | 04:40:40 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:45896/tests/kraken/driver.html?testName=audio-fft) 04:40:41 INFO - PROCESS | 26966 | RSS: Main: 146595840 04:40:41 INFO - PROCESS | 26966 | 04:40:43 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:45896/tests/kraken/driver.html?testName=audio-oscillator) 04:40:43 INFO - PROCESS | 26966 | RSS: Main: 145944576 04:40:43 INFO - PROCESS | 26966 | 04:40:46 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:45896/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:40:46 INFO - PROCESS | 26966 | RSS: Main: 145129472 04:40:46 INFO - PROCESS | 26966 | 04:40:49 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:45896/tests/kraken/driver.html?testName=imaging-darkroom) 04:40:50 INFO - PROCESS | 26966 | RSS: Main: 147386368 04:40:50 INFO - PROCESS | 26966 | 04:40:53 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:45896/tests/kraken/driver.html?testName=imaging-desaturate) 04:40:54 INFO - PROCESS | 26966 | RSS: Main: 146468864 04:40:54 INFO - PROCESS | 26966 | 04:40:57 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:45896/tests/kraken/driver.html?testName=json-parse-financial) 04:40:58 INFO - PROCESS | 26966 | RSS: Main: 145817600 04:40:58 INFO - PROCESS | 26966 | 04:40:59 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:45896/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:41:00 INFO - PROCESS | 26966 | RSS: Main: 147050496 04:41:00 INFO - PROCESS | 26966 | 04:41:02 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:45896/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:41:02 INFO - PROCESS | 26966 | RSS: Main: 147574784 04:41:02 INFO - PROCESS | 26966 | 04:41:05 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:45896/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:41:05 INFO - PROCESS | 26966 | RSS: Main: 148357120 04:41:05 INFO - PROCESS | 26966 | 04:41:08 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:45896/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:41:08 INFO - PROCESS | 26966 | RSS: Main: 147656704 04:41:08 INFO - PROCESS | 26966 | 04:41:11 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:45896/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:41:12 INFO - PROCESS | 26966 | RSS: Main: 148201472 04:41:12 INFO - PROCESS | 26966 | 04:41:13 INFO - PROCESS | 26966 | Cycle 1(1): loaded http://localhost:45896/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:45896/tests/kraken/driver.html?testName=ai-astar) 04:41:14 INFO - PROCESS | 26966 | RSS: Main: 149405696 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | __start_tp_report 04:41:14 INFO - PROCESS | 26966 | _x_x_mozilla_page_load 04:41:14 INFO - PROCESS | 26966 | _x_x_mozilla_page_load_details 04:41:14 INFO - PROCESS | 26966 | |i|pagename|runs| 04:41:14 INFO - PROCESS | 26966 | |0;ai-astar;118;111;114;114;113;124;114;113;116;113 04:41:14 INFO - PROCESS | 26966 | |1;audio-beat-detection;164;131;155;171;135;158;165;140;176;128 04:41:14 INFO - PROCESS | 26966 | |2;audio-dft;165;164;162;167;163;166;167;164;172;166 04:41:14 INFO - PROCESS | 26966 | |3;audio-fft;76;73;74;74;77;140;72;73;75;74 04:41:14 INFO - PROCESS | 26966 | |4;audio-oscillator;99;97;138;98;98;97;138;98;99;133 04:41:14 INFO - PROCESS | 26966 | |5;imaging-gaussian-blur;110;110;110;109;109;109;109;114;109;110 04:41:14 INFO - PROCESS | 26966 | |6;imaging-darkroom;149;149;147;148;149;148;147;148;147;147 04:41:14 INFO - PROCESS | 26966 | |7;imaging-desaturate;97;98;96;96;96;97;96;96;96;96 04:41:14 INFO - PROCESS | 26966 | |8;json-parse-financial;71;72;71;71;70;73;71;70;70;69 04:41:14 INFO - PROCESS | 26966 | |9;json-stringify-tinderbox;67;69;72;67;70;69;68;69;67;68 04:41:14 INFO - PROCESS | 26966 | |10;stanford-crypto-aes;82;83;83;84;91;84;84;92;83;85 04:41:14 INFO - PROCESS | 26966 | |11;stanford-crypto-ccm;120;126;121;135;135;123;125;127;139;122 04:41:14 INFO - PROCESS | 26966 | |12;stanford-crypto-pbkdf2;139;150;149;150;146;141;146;148;158;136 04:41:14 INFO - PROCESS | 26966 | |13;stanford-crypto-sha256-iterative;73;72;71;71;71;71;71;73;70;70 04:41:14 INFO - PROCESS | 26966 | __end_tp_report 04:41:14 INFO - PROCESS | 26966 | __start_cc_report 04:41:14 INFO - PROCESS | 26966 | _x_x_mozilla_cycle_collect,817 04:41:14 INFO - PROCESS | 26966 | __end_cc_report 04:41:14 INFO - PROCESS | 26966 | __startTimestamp1452602474176__endTimestamp 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | ------- Summary: start ------- 04:41:14 INFO - PROCESS | 26966 | Number of tests: 14 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#0] ai-astar Cycles:10 Average:115.00 Median:114.00 stddev:3.68 (3.2%) stddev-sans-first:3.74 04:41:14 INFO - PROCESS | 26966 | Values: 118.0 111.0 114.0 114.0 113.0 124.0 114.0 113.0 116.0 113.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#1] audio-beat-detection Cycles:10 Average:152.30 Median:161.00 stddev:17.46 (10.8%) stddev-sans-first:18.00 04:41:14 INFO - PROCESS | 26966 | Values: 164.0 131.0 155.0 171.0 135.0 158.0 165.0 140.0 176.0 128.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#2] audio-dft Cycles:10 Average:165.60 Median:166.00 stddev:2.80 (1.7%) stddev-sans-first:2.96 04:41:14 INFO - PROCESS | 26966 | Values: 165.0 164.0 162.0 167.0 163.0 166.0 167.0 164.0 172.0 166.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#3] audio-fft Cycles:10 Average:80.80 Median:74.00 stddev:20.85 (28.2%) stddev-sans-first:22.05 04:41:14 INFO - PROCESS | 26966 | Values: 76.0 73.0 74.0 74.0 77.0 140.0 72.0 73.0 75.0 74.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#4] audio-oscillator Cycles:10 Average:109.50 Median:98.00 stddev:18.58 (19.0%) stddev-sans-first:19.31 04:41:14 INFO - PROCESS | 26966 | Values: 99.0 97.0 138.0 98.0 98.0 97.0 138.0 98.0 99.0 133.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#5] imaging-gaussian-blur Cycles:10 Average:109.90 Median:110.00 stddev:1.52 (1.4%) stddev-sans-first:1.62 04:41:14 INFO - PROCESS | 26966 | Values: 110.0 110.0 110.0 109.0 109.0 109.0 109.0 114.0 109.0 110.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#6] imaging-darkroom Cycles:10 Average:147.90 Median:148.00 stddev:0.88 (0.6%) stddev-sans-first:0.83 04:41:14 INFO - PROCESS | 26966 | Values: 149.0 149.0 147.0 148.0 149.0 148.0 147.0 148.0 147.0 147.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.71 04:41:14 INFO - PROCESS | 26966 | Values: 97.0 98.0 96.0 96.0 96.0 97.0 96.0 96.0 96.0 96.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#8] json-parse-financial Cycles:10 Average:70.80 Median:71.00 stddev:1.14 (1.6%) stddev-sans-first:1.20 04:41:14 INFO - PROCESS | 26966 | Values: 71.0 72.0 71.0 71.0 70.0 73.0 71.0 70.0 70.0 69.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#9] json-stringify-tinderbox Cycles:10 Average:68.60 Median:69.00 stddev:1.58 (2.3%) stddev-sans-first:1.56 04:41:14 INFO - PROCESS | 26966 | Values: 67.0 69.0 72.0 67.0 70.0 69.0 68.0 69.0 67.0 68.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#10] stanford-crypto-aes Cycles:10 Average:85.10 Median:84.00 stddev:3.48 (4.1%) stddev-sans-first:3.50 04:41:14 INFO - PROCESS | 26966 | Values: 82.0 83.0 83.0 84.0 91.0 84.0 84.0 92.0 83.0 85.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#11] stanford-crypto-ccm Cycles:10 Average:127.30 Median:126.50 stddev:6.68 (5.3%) stddev-sans-first:6.55 04:41:14 INFO - PROCESS | 26966 | Values: 120.0 126.0 121.0 135.0 135.0 123.0 125.0 127.0 139.0 122.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:146.30 Median:148.50 stddev:6.34 (4.3%) stddev-sans-first:6.15 04:41:14 INFO - PROCESS | 26966 | Values: 139.0 150.0 149.0 150.0 146.0 141.0 146.0 148.0 158.0 136.0 04:41:14 INFO - PROCESS | 26966 | 04:41:14 INFO - PROCESS | 26966 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.30 Median:71.00 stddev:1.06 (1.5%) stddev-sans-first:0.93 04:41:14 INFO - PROCESS | 26966 | Values: 73.0 72.0 71.0 71.0 71.0 71.0 71.0 73.0 70.0 70.0 04:41:14 INFO - PROCESS | 26966 | -------- Summary: end -------- 04:41:14 INFO - PROCESS | 26966 | 04:41:15 INFO - TEST-INFO | 26966: exit 0 04:41:15 INFO - TEST-OK | kraken | took 62778ms 04:41:15 INFO - TEST-START | v8_7 04:41:15 INFO - operating with platform_type : linux_ 04:41:15 INFO - Initialising browser for v8_7 test... 04:41:15 INFO - TEST-INFO | started process 27250 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1Xw12i/profile http://localhost:45896/getInfo.html) 04:41:19 INFO - PROCESS | 27250 | 04:41:19 INFO - PROCESS | 27250 | (process:27322): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:41:20 INFO - PROCESS | 27250 | __metrics Screen width/height:1600/1200 04:41:20 INFO - PROCESS | 27250 | colorDepth:24 04:41:20 INFO - PROCESS | 27250 | Browser inner width/height: 1024/697 04:41:20 INFO - PROCESS | 27250 | __metrics 04:41:20 INFO - PROCESS | 27250 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 04:41:21 INFO - TEST-INFO | 27250: exit 0 04:41:21 INFO - Browser initialized. 04:41:21 INFO - Running cycle 1/1 for v8_7 test... 04:41:21 INFO - TEST-INFO | started process 27371 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1Xw12i/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:41:23 INFO - PROCESS | 27371 | 04:41:23 INFO - PROCESS | 27371 | (process:27429): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:41:33 INFO - PROCESS | 27371 | RSS: Main: 149946368 04:41:33 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | Cycle 1(1): loaded http://localhost:45896/tests/v8_7/run.html (next: http://localhost:45896/tests/v8_7/run.html) 04:41:56 INFO - PROCESS | 27371 | RSS: Main: 145833984 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | __start_tp_report 04:41:56 INFO - PROCESS | 27371 | _x_x_mozilla_page_load 04:41:56 INFO - PROCESS | 27371 | _x_x_mozilla_page_load_details 04:41:56 INFO - PROCESS | 27371 | |i|pagename|runs| 04:41:56 INFO - PROCESS | 27371 | |0;Richards;167.0564650851988 04:41:56 INFO - PROCESS | 27371 | |1;DeltaBlue;186.46280067126608 04:41:56 INFO - PROCESS | 27371 | |2;Encrypt;278.2415136338342 04:41:56 INFO - PROCESS | 27371 | |3;Decrypt;5301.587301587301 04:41:56 INFO - PROCESS | 27371 | |4;RayTrace;1077.502691065662 04:41:56 INFO - PROCESS | 27371 | |5;Earley;723.589001447178 04:41:56 INFO - PROCESS | 27371 | |6;Boyer;12884.615384615385 04:41:56 INFO - PROCESS | 27371 | |7;RegExp;43340.425531914894 04:41:56 INFO - PROCESS | 27371 | |8;Splay;595.5926146515783 04:41:56 INFO - PROCESS | 27371 | |9;NavierStokes;4830.917874396136 04:41:56 INFO - PROCESS | 27371 | __end_tp_report 04:41:56 INFO - PROCESS | 27371 | __startTimestamp1452602516432__endTimestamp 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | ------- Summary: start ------- 04:41:56 INFO - PROCESS | 27371 | Number of tests: 10 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#0] Richards Cycles:1 Average:167.06 Median:167.06 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 167.1 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#1] DeltaBlue Cycles:1 Average:186.46 Median:186.46 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 186.5 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#2] Encrypt Cycles:1 Average:278.24 Median:278.24 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 278.2 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#3] Decrypt Cycles:1 Average:5301.59 Median:5301.59 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 5301.6 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#4] RayTrace Cycles:1 Average:1077.50 Median:1077.50 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 1077.5 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#5] Earley Cycles:1 Average:723.59 Median:723.59 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 723.6 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#6] Boyer Cycles:1 Average:12884.62 Median:12884.62 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 12884.6 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#7] RegExp Cycles:1 Average:43340.43 Median:43340.43 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 43340.4 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#8] Splay Cycles:1 Average:595.59 Median:595.59 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 595.6 04:41:56 INFO - PROCESS | 27371 | 04:41:56 INFO - PROCESS | 27371 | [#9] NavierStokes Cycles:1 Average:4830.92 Median:4830.92 stddev:0.00 (0.0%) 04:41:56 INFO - PROCESS | 27371 | Values: 4830.9 04:41:56 INFO - PROCESS | 27371 | -------- Summary: end -------- 04:41:56 INFO - PROCESS | 27371 | 04:41:57 INFO - TEST-INFO | 27371: exit 0 04:41:57 INFO - TEST-OK | v8_7 | took 42192ms 04:41:57 INFO - SUITE-END | took 1220s 04:41:57 INFO - Completed test suite (00:20:20) 04:41:57 INFO - Working with test: dromaeo_css 04:41:57 INFO - Generating results file: dromaeo_css 04:41:57 INFO - Working with test: kraken 04:41:57 INFO - Generating results file: kraken 04:41:57 INFO - javascript benchmark 04:41:57 INFO - Working with test: v8_7 04:41:57 INFO - Generating results file: v8_7 04:41:57 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:41:57 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,132,43]] 04:41:57 INFO - process_Request line: dromaeo_css 6158.29 graph.html#tests=[[72,132,43]] 04:41:57 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:41:57 INFO - process_Request line: kraken 1546.80 graph.html#tests=[[232,132,43]] 04:41:57 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:41:57 INFO - process_Request line: v8_7 20147.15 graph.html#tests=[[230,132,43]] 04:41:57 INFO - RETURN: dromaeo_css: 6158.29 04:41:57 INFO - RETURN: kraken: 1546.80 04:41:57 INFO - RETURN: v8_7: 20147.15 04:41:57 INFO - javascript benchmark 04:41:57 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2622.921312360629, 2654.296611397981, 2677.611746296787, 2685.328667833043, 2697.1099537152736, 4360.345948107785, 4494.662900282476, 4554.2940844169125, 4561.1789877821975, 4592.977035114824, 4484.4170257866435, 4515.300128480083, 4519.480259770119, 4560.612347950429, 4647.070585882829, 4214.072903961123, 4239.576042395766, 4308.289132293168, 4309.052008558112, 4333.2416827055295, 474.3116892263269, 4209.684273679471, 4217.0, 4280.74315541067, 4334.133173365324, 4176.9582304177175, 4236.68224883135, 4241.766702831327, 4254.298040823261, 4289.721168124062, 4248.830046798124, 4266.0827921996915, 4280.871573852789, 4310.374995625648, 4332.1119170569955, 4102.876913692594, 4162.1259535497275, 4175.519815221258, 4181.581841815824, 4236.131593023453, 4412.75729834859, 4448.555144485558, 4452.265376212921, 4473.46318441789, 4477.17172323118, 4781.306710526954, 4830.758462076882, 4840.564349208588, 4846.39420072491, 4846.5880400166025, 4803.3995750531185, 4814.253790662453, 4878.926816097762, 4929.926051109236, 4962.727050012248, 4470.284754439274, 4482.305242687388, 4500.212462818994, 4512.3908272382805, 4521.864344069683, 4853.95146048535, 4905.2151655734915, 4912.5016869855035, 4924.409070911442, 4954.380702412199, 4718.221493453541, 4759.048190361941, 4759.524047595212, 4783.210770222874, 4814.9518504814505, 4806.303086052503, 4816.95183048172, 4830.855074347775, 4837.975810120927, 4868.659193856467, 4666.603338716247, 4705.529447055335, 4729.95270047302, 4730.5032971538185, 4790.377250957354, 4803.927941080887, 4812.374391329105, 4813.78337974792, 4830.903381932412, 4885.438174609965, 4109.773962432095, 4111.8560850370095, 4119.155573107506, 4129.504459464823, 4138.213739389506, 3573.9642603574152, 3618.5476815398074, 3633.2370202257293, 3656.213914008501, 3680.3007428589017, 4171.728837625545, 4191.455110835572, 4192.22443847883, 4218.810153543098, 4238.7032907696785, 4809.95190048102, 4840.201366774443, 4841.12859685253, 4846.39420072491, 4878.853634390974, 4107.260693075215, 4173.520045194841, 4181.51912530063, 4204.26425375558, 4261.637760790306, 4299.6775241856985, 4307.246231909403, 4316.417283666728, 4325.7188282762145, 4368.104538569585, 4536.500984891659, 4540.069285796338, 4547.522510136454, 4586.610138138229, 4589.609883159968, 4714.198586240279, 4803.303520989507, 4808.014357056865, 4868.3427737255015, 4945.752712364296, 4577.610903073276, 4580.816767329269, 4587.541245875385, 4588.770561471846, 4605.171069207575, 4742.217534106834, 4746.121967436035, 4767.809287628456, 4779.952200477951, 4815.398075240595, 4682.578567928903, 4765.666403351732, 4844.563989240985, 4877.024595080927, 4929.926051109308, 4625.352450656844, 4672.415948006499, 4673.299005149255, 4695.5304469552775, 4709.5290470954005, 4588.839390621312, 4649.093426781745, 4673.696209746356, 4690.319903614025, 4732.929006064981, 4521.208788462071, 4545.363649089064, 4565.33802598628, 4571.748553829439, 4638.953610463852, 4691.859244222679, 4738.644601654959, 4746.4541577719, 4748.8100475981955, 4778.665493415428, 4563.452385713736, 4651.279051746985, 4662.953370466252, 4665.32352808834, 4701.600363969101], "unit": "score", "name": "dojo.html", "value": 4429.192695684534}, {"lowerIsBetter": false, "replicates": [488.49684824630646, 525.8133362656255, 546.721172202177, 566.5411017076169, 579.4350508254453, 31628.525572116407, 32102.35795284093, 32153.839230803813, 32316.353672926587, 32343.67656323439, 36203.094922626944, 36745.632543674554, 36785.0, 36868.81565592168, 36989.63010369895, 7522.172561018284, 7698.653560589759, 7707.884381734279, 7710.730124445646, 7712.228777122299, 7577.5453472791805, 7731.652075656609, 7744.0, 7896.447248692594, 7906.209379062106, 7719.768406947801, 7757.224277572254, 7771.067471903351, 7803.843923121534, 7810.687572497093, 7824.256695613907, 7864.252895974902, 7921.168277330912, 7926.682932682744, 7942.761717148494, 7493.925060749377, 7528.623568821592, 7561.357284630813, 7568.091828980502, 7580.469367144302, 36260.456093158624, 36270.81864590687, 36361.81819090914, 36404.81797591021, 36473.27053458943, 2311.976880231193, 2805.2425845021935, 2888.364559796841, 2933.208033830875, 3192.8722851085927, 24106.7589324108, 24227.372795409112, 24360.02559897602, 24534.754652453426, 24620.876895615587, 3322.8504717287537, 3429.5198672185916, 3459.60214575322, 3490.0, 3499.5450591423205, 173940.0, 175147.0, 175919.0, 176467.0, 297758.0, 42545.36181957273, 55734.44265557292, 57456.0, 57505.71247143738, 57543.71228143916, 53456.73271633695, 54509.45490545044, 54510.45489545133, 54713.452865471634, 54759.45240547623, 13122.737545249232, 13201.47194112244, 13265.933670331586, 13315.0, 13332.600021999162, 9768.0, 9913.603455861685, 9944.751381215383, 9953.651622193189, 9961.302708810459, 19012.545971205443, 19429.80570194308, 19434.0, 19494.122764475633, 19519.902400487907, 6847.554908930903, 6991.650417479105, 7004.3696067354185, 7033.824154396181, 7035.824104397431, 839.6347588798892, 845.1337379186383, 913.8263729891432, 987.5555999800118, 1020.6937918624383, 25521.744782551938, 25894.611580826302, 26194.86902565475, 26456.206313810617, 26611.733882661312, 872.389327470773, 880.3969281042506, 986.5757724178528, 989.9803202701229, 1017.7150397888603, 12665.303408312631, 12804.42380092898, 12857.485700572059, 13104.868951310556, 13163.473461061642, 260700.0, 262410.0, 263288.0, 263373.0, 263416.0, 43755.78122109369, 43939.0, 43962.34056489155, 44104.558954410684, 44128.558714413084, 1185.697647099984, 1207.4385410784027, 1223.1437993404652, 1223.1988047828509, 1225.1913736933582, 24396.390090247885, 25386.619200712372, 25685.61471577965, 25804.0, 25871.482570348864, 39515.80242098771, 39541.60458395379, 39835.211535192255, 39898.601013989486, 39994.20011599694, 252521.0, 252618.0, 252837.0, 253432.0, 253551.0, 25573.488530229664, 28400.005999790734, 29107.417851643273, 29319.0, 29329.0, 33536.49695254622, 33763.83118084394, 33799.83100084484, 34650.30699386049, 34651.30697386088, 28623.713762862106, 29219.85390073036, 29267.414651707273, 29301.26746831261, 29691.109266722033, 28602.42795144127, 28659.8567007172, 29059.7094029057, 29098.127056188347, 31602.893898713435, 29845.10464686063, 30021.399572008875, 30028.84985575058, 30186.24534386658, 30221.69778302189, 28100.71899280981, 29103.85448072746, 30652.84673576618, 30709.69290307068, 30987.535186971763, 21670.67493987623, 21878.249740021078, 22633.2078377256, 23166.768332317137, 23504.6474302889], "unit": "score", "name": "ext.html", "value": 16108.324019341162}, {"lowerIsBetter": false, "replicates": [342.43840102232326, 344.1173390253998, 344.78450968144904, 345.31972015130185, 345.94810778383254, 14109.365078571464, 14228.857711422883, 14784.926075369609, 15106.0, 15506.604405603493, 9466.479343636114, 9699.806003879918, 11028.889711102907, 14262.286885655702, 14330.498432554863, 4357.891052723683, 4469.82120715171, 4535.523770004152, 4560.680752347337, 5048.469910659383, 4940.308356830046, 5037.59699224063, 5039.0, 5044.142495775709, 5054.21659642756, 3305.4711246200613, 3500.7724497907557, 5002.59979201663, 5022.899542009158, 5122.385313762354, 5156.407013193493, 5176.0, 5176.378834539842, 5179.223116532513, 5206.609504287175, 4897.632677549198, 5179.585633149377, 5179.766910489037, 5194.584433245332, 5220.0, 11665.475053622607, 11778.646640600795, 16712.41506547265, 18394.908025459787, 18444.89330640166, 1625.0980705708328, 1702.8126906040325, 1768.5136587438558, 1799.1813724755204, 1860.7767067951797, 8163.632636531311, 8542.914570854275, 8681.04508504064, 8914.331425143075, 9089.409188402733, 1690.0, 1753.9123043847756, 1782.4474412932032, 1794.4347530527973, 1827.4060930197738, 49330.01339973216, 49983.500164998615, 49992.25011624829, 50651.493485065046, 51540.48459515432, 9681.661141860142, 9690.806183876424, 9723.076307750753, 9725.465099419458, 9778.706638800848, 12276.447559859827, 12322.81515777264, 12399.628011159679, 12421.627351179479, 12430.875691243153, 6362.77730279438, 6495.4803615710625, 6510.446612037935, 6608.603483790988, 6621.172353455818, 6058.757649693963, 6081.513478921675, 6105.084237364431, 6239.0953311770445, 6247.0, 4135.359019352005, 4167.874963751093, 4175.269327867611, 4182.351735481006, 4226.0, 1757.349780581193, 1791.3909270847973, 1807.954801129956, 1818.5090025693253, 1828.1042289278157, 724.5616402076668, 840.684743221292, 845.2097289034772, 893.9061398553058, 924.9686599441574, 12573.937130314473, 13563.932180339036, 14222.502212422516, 14308.856911430752, 15277.541673749805, 834.8580741273998, 848.1264297773304, 863.8099618084011, 882.4264228251687, 886.0740526150189, 8690.608922598498, 8846.646134154691, 8922.0, 9084.364814333483, 9186.94350149728, 442120.0, 445690.0, 456387.0, 458223.0, 460967.0, 62844.0, 66655.0, 67090.3290967084, 67305.32694673089, 67986.66006669935, 1077.9137668986618, 1081.5295346524288, 1085.7285678580513, 1095.424901926479, 1097.078454098545, 13838.65403364924, 13893.95795315335, 13964.581062568139, 14124.0, 14193.858061419254, 31333.686663133987, 31553.21116972094, 31623.20941976377, 32186.35627287488, 32552.674473254963, 41270.0, 41512.79243603763, 41554.0, 41623.791881041616, 41857.58142418659, 4832.540908613676, 6860.142482189726, 6879.793606191823, 7038.964805175941, 7119.181294151032, 8064.919350806652, 9445.291603129655, 9568.856467153137, 9699.757506062404, 9722.222222222064, 7715.807104822425, 8173.264406203471, 8192.83614327722, 8220.424570280262, 8259.669613215645, 9044.457332560067, 9060.365774395728, 9114.225290850352, 9399.671011514563, 9450.243980481682, 8488.448250863674, 8771.210591046836, 8871.423357481743, 8916.643334266557, 9095.226905713089, 6825.180978282439, 6948.33990770876, 7011.719531218694, 7042.718291268497, 7148.356647901714, 7833.725819596287, 8119.18808119207, 8744.737657870273, 8794.120587941155, 8932.50871202064], "unit": "score", "name": "jquery.html", "value": 7360.122462424548}, {"lowerIsBetter": false, "replicates": [1401.7266633006564, 1415.3347926474553, 1538.1693885301938, 1696.635223426963, 1717.7509261157124, 6398.264199617045, 6515.120458738069, 7474.813129671754, 7659.080910290766, 7675.769726908187, 7210.567365958046, 7422.0, 7476.289752473506, 7483.625818709056, 7483.775486735407, 2173.1307477009245, 2198.5492973940304, 2203.5813195492806, 2215.3796936857707, 2217.2572188316935, 2166.3392665237097, 2187.55155193185, 2187.726534183227, 2194.1333173396497, 2199.2192771566106, 2161.5352699169675, 2164.6103701333755, 2170.392290158758, 2172.7827217278223, 2233.0955962834996, 2185.4208634711813, 2195.6157672407426, 2196.374033400481, 2197.4176843136584, 2200.273909609833, 2140.047678782942, 2170.1319472211085, 2172.902219400131, 2181.792729690693, 2184.3010236724253, 7630.160682324939, 7702.961485192538, 7718.729844455417, 7729.111152217511, 7742.961285193594, 4162.500499939996, 4218.029853133797, 4255.2978758504805, 4261.488621365425, 4283.2932566126865, 2604.7785938195275, 2621.685397752263, 2667.1331817159503, 2687.6371689821817, 2688.4623075384807, 831.7421599304236, 839.2824135364236, 843.2284459719349, 874.5583480342386, 878.9824203515958, 9582.856257156149, 9594.712158635251, 9598.856017159747, 9624.0, 9641.614335426575, 3921.7646941183048, 3971.960280397159, 3989.92020159601, 3994.0813612868624, 4028.9395659064553, 8353.457025293337, 8361.749147525585, 8393.160683931557, 8396.328293736486, 8401.15988401155, 4284.378765079108, 4288.871333859989, 4289.506706728704, 4299.591538803808, 4301.16127355169, 3870.574236833946, 3897.162110146332, 3980.2636512245326, 4103.179364127186, 4116.91766164675, 3284.3759685659647, 3294.077658255644, 3327.284633803744, 3340.465525515906, 3352.1452029732263, 971.1793534463367, 973.6543527047937, 976.8192884316425, 981.9018098190123, 1000.2847963705985, 1123.528118190362, 1129.9548018079186, 1136.9829452558217, 1144.9771004580027, 1158.0561842098662, 6715.5299129060495, 7197.640117994079, 7328.120625524971, 7364.926350736531, 7365.373943214887, 955.7419496735843, 980.2550061952967, 991.9256055795844, 1038.8597539332245, 1070.2401295080424, 5461.1262198048125, 5499.862503437446, 5649.350324712628, 5652.293463317085, 5654.208410822488, 8477.74566762998, 8727.083656216006, 8754.824903501894, 8791.956040219886, 8852.690155844515, 8753.431026983226, 8897.377183597215, 8920.107989201158, 8923.866142007875, 8938.68714594986, 7033.824154396181, 7123.287671232835, 7152.427805775629, 7187.425005999507, 7195.92804071963, 6726.8990965136545, 6783.457323414016, 6946.756863509753, 6950.756723514653, 6955.443564514725, 8108.554029528433, 8136.75589732309, 8264.297534709376, 8284.627191776504, 8322.0, 8333.208345207195, 8377.371697122619, 8478.0, 8517.616707248064, 8591.269742071994, 5699.971500142473, 5824.213731146241, 6625.072489851328, 6772.11962444879, 6807.183138023469, 6471.935280647133, 6578.506612004215, 6593.703283352164, 6609.735610575523, 6618.602883826986, 6099.542534309856, 6214.720337584729, 6242.0, 6305.8108256752375, 6348.93651063502, 6118.816435506942, 6150.7847225346895, 6211.440970312694, 6222.28443728977, 6339.049142628458, 6236.064590311489, 6246.718897649525, 6264.874702506016, 6397.744090236339, 6405.967970160119, 5978.252718410199, 5982.042873140451, 6040.426159514839, 6041.879162416815, 6058.394160583906, 5936.7922122725495, 5950.583459157818, 5955.851103722442, 6007.249093863267, 6011.128386383863], "unit": "score", "name": "mootools.html", "value": 4186.801234870023}, {"lowerIsBetter": false, "replicates": [316.08966177409064, 319.4808436291027, 324.72207464635574, 327.089056976321, 328.51215944322684, 5592.384837667853, 5625.887482250352, 5660.632058916168, 5669.177969194464, 5767.884642307151, 5578.0, 5615.9157612635845, 5625.46558076982, 5664.858378540539, 5681.375048744635, 4297.376880352347, 4301.268784306675, 4304.741715497064, 4305.67707421943, 4309.6336811371075, 4296.248156572603, 4317.956820431787, 4318.179545886287, 4321.200577893084, 4324.853913712868, 4164.10471748574, 4218.641415479673, 4259.16946195492, 4266.360045993095, 4268.59448352406, 4202.075543380467, 4244.596763307481, 4254.7872606369865, 4257.233697934371, 4271.252530807112, 3673.9712880393267, 3678.5401824771902, 3678.9331093982983, 3680.4479328100733, 3684.1158122050783, 5364.973175134139, 5381.3811411687375, 5384.434634363413, 5390.299261096072, 5393.703346315951, 4717.956878033237, 4900.534449227318, 4910.8281210157475, 4912.017596480682, 4917.606591472673, 5670.744816483269, 5829.795957141479, 5852.571182959067, 5864.325602555718, 5872.354041055481, 3973.304671682444, 3973.9006524836823, 3998.4402183694306, 4001.919961600781, 4002.419649150857, 6160.722767475474, 6184.350643182491, 6220.813375598785, 6221.937780622181, 6222.719977601018, 4049.6152865477734, 4192.853250136231, 4198.958010419857, 4199.832006719758, 4207.495100587949, 4241.533431322552, 4246.7027308088755, 4255.085156691326, 4310.547392523803, 4310.568943105664, 4841.636877234221, 4874.8781280467565, 4893.975530122327, 4894.510548945077, 4902.803887844446, 5802.535797136219, 5858.648481091148, 5885.323187833368, 5891.3814049525035, 5900.4099590041515, 1448.7826825975976, 1493.4101030093052, 1502.278906125066, 1509.1473317575535, 1517.415794918942, 936.6253498600478, 946.5172761891347, 967.3083745122271, 990.5245482168599, 994.1301361308855, 5024.547790698854, 5026.472220416877, 5038.2190760432195, 5041.067402530543, 5041.546260836542, 6015.54883383748, 6017.976943919544, 6025.9096113558335, 6057.727402266909, 6062.151298818169, 5038.899222015539, 5054.342935418372, 5060.165072762953, 5061.6962982221185, 5076.74616269185, 3217.9195520111716, 3250.138713240993, 3262.8042317461027, 3270.640229574745, 3281.8523166457567, 5652.293463317085, 5665.688387138664, 5667.943320566742, 5680.573956953162, 5685.77256909719, 6202.4417802398, 6218.22272215973, 6250.9062364064575, 6252.843678908063, 6262.718177682015, 5555.50000499957, 5617.606767526234, 5673.092305231144, 5681.545476361881, 5687.601867869293, 5975.760969561169, 6054.606450580698, 6060.333363329942, 6061.969690151521, 6075.544334174866, 5898.793542226002, 5904.114382842608, 5905.379935106752, 5908.172855800278, 5913.46778789911, 5652.519535839499, 5657.8019769307875, 5665.065264231355, 5667.404922483245, 5681.857953551029, 4126.0, 4139.958600414077, 4163.375493675972, 4299.419578357007, 4299.95700043008, 6003.529135361864, 6071.089336599545, 6078.878422431615, 6086.908696369469, 6092.878142437038, 5863.970680146572, 5903.852403689771, 5907.2911250650195, 5908.468237858613, 5912.586118971631, 5851.912221316768, 5875.911861321998, 5947.0, 5968.4926781224085, 5969.791057312973, 5599.300087489064, 5737.971310143423, 5742.7702891883855, 5755.395683453345, 5786.855328616818, 5976.760929562769, 5979.5814292999075, 6002.339742628395, 6005.849853753691, 6021.939780602138, 5798.33319168301, 5842.0, 5853.0635098384055, 5853.356130825691, 5877.147813566923], "unit": "score", "name": "prototype.html", "value": 4383.881382248869}, {"lowerIsBetter": false, "replicates": [627.5324882962191, 691.6023286610197, 703.7572037647013, 756.500709531709, 764.4304992780379, 11431.142664300169, 11622.593209237679, 11630.302181869094, 11648.825267620981, 12964.286964216964, 13446.126001809875, 13613.727725445486, 13640.386182621782, 13652.317384130803, 13674.931625341884, 756.4666909828585, 762.1273641680273, 769.2384539306074, 773.0645918438696, 777.0, 768.4851149729667, 772.0735117858565, 773.5899973014311, 774.8915151878741, 775.8603451378749, 802.5224991130298, 805.7743831727125, 805.9717909873156, 807.5840941914919, 808.4946908182386, 784.3019712455919, 787.7636708987338, 789.6130895861015, 789.8064974081358, 791.3708601661692, 595.1043679262725, 595.5830918357167, 596.1951365656373, 596.6479776931587, 596.785157343356, 12569.0, 12680.239185648798, 12681.682957926034, 12688.111832171751, 12692.238465692088, 11011.174161937806, 11284.210105292634, 11339.319640821577, 11417.31496110236, 11483.0, 9099.361185256268, 9644.083812037845, 9654.806903861954, 9707.805843883083, 9710.417374957526, 3967.2462232175794, 3995.960040399617, 4003.5796241394523, 4026.4362989181536, 4116.135611521584, 41119.1776164478, 41285.380719289235, 41356.0, 41487.58512414897, 41490.0, 9043.23132533742, 9202.723918282461, 9363.067129457237, 9402.576884040234, 9465.574049167804, 15933.681326373408, 15995.12026838535, 16045.358185672443, 16060.919695401448, 16074.919625401799, 6214.192155019909, 6250.937490625127, 6303.527235457359, 6316.747330106744, 6410.391012853772, 3552.467129930531, 3604.711623070148, 3628.32875917956, 3631.4371272452813, 3636.760662636884, 2586.1465716313573, 2616.3851494898686, 2620.489004644076, 2622.960655590168, 2627.238100950741, 457.9015511665008, 473.9810407583727, 475.75974133062584, 489.6670264220293, 492.2173743747387, 565.2425749495613, 568.5877738639454, 590.8109404990362, 595.2589026661834, 627.4071002902305, 7330.0, 7387.6675549600395, 7635.809104772314, 7773.222677732295, 7816.804579885548, 456.9337446070301, 470.3978906999047, 503.41855157293384, 614.9822044516333, 620.8696173803462, 3613.801240931774, 3683.4474828775897, 3762.360398732222, 3807.8286477108595, 3872.6901847852105, 45510.772446137555, 45917.540824592, 48263.0, 48514.0, 51121.0, 40726.0, 41084.38373424401, 41169.58830411718, 41422.79288603598, 41816.37275440871, 36481.0, 37129.0, 37848.62151378506, 37956.0, 37972.05069873275, 7558.9244107558225, 7858.489198202098, 7907.604619769104, 7922.405819563441, 8357.164283571838, 26915.461690766468, 27570.86214568914, 28032.71967280301, 28283.858580706965, 28301.71698282991, 37050.0, 37194.0, 37239.813800930824, 37641.43537846989, 37721.05697357588, 9948.204143668634, 9953.303268771117, 10085.142762864945, 10116.190704743456, 10158.949205253926, 10784.406857622906, 10797.24419290642, 10985.340879547253, 10996.607883200082, 11340.6030788922, 10240.795184096425, 10341.534630941474, 10459.94770026145, 10489.632862849763, 10563.471826408802, 10323.845142323022, 10441.183061837293, 10465.790684186426, 10892.836607450736, 11090.944545277222, 9632.084951929555, 9795.06946840049, 9814.607415703293, 9846.409215447096, 9948.204143668634, 8267.751967440987, 8568.785780355542, 8576.185262400062, 8727.738167854974, 8771.38600297973, 8664.436811607226, 8724.738257852274, 8968.910310896808, 9107.499087550248, 9109.817803644022], "unit": "score", "name": "yui.html", "value": 5658.743467483616}], "name": "dromaeo_css", "value": 6158.291696837633}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [118.0, 111.0, 114.0, 114.0, 113.0, 124.0, 114.0, 113.0, 116.0, 113.0], "unit": "score", "name": "ai-astar", "value": 115.0}, {"lowerIsBetter": true, "replicates": [164.0, 131.0, 155.0, 171.0, 135.0, 158.0, 165.0, 140.0, 176.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 152.3}, {"lowerIsBetter": true, "replicates": [165.0, 164.0, 162.0, 167.0, 163.0, 166.0, 167.0, 164.0, 172.0, 166.0], "unit": "score", "name": "audio-dft", "value": 165.6}, {"lowerIsBetter": true, "replicates": [76.0, 73.0, 74.0, 74.0, 77.0, 140.0, 72.0, 73.0, 75.0, 74.0], "unit": "score", "name": "audio-fft", "value": 80.8}, {"lowerIsBetter": true, "replicates": [99.0, 97.0, 138.0, 98.0, 98.0, 97.0, 138.0, 98.0, 99.0, 133.0], "unit": "score", "name": "audio-oscillator", "value": 109.5}, {"lowerIsBetter": true, "replicates": [110.0, 110.0, 110.0, 109.0, 109.0, 109.0, 109.0, 114.0, 109.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.9}, {"lowerIsBetter": true, "replicates": [149.0, 149.0, 147.0, 148.0, 149.0, 148.0, 147.0, 148.0, 147.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 147.9}, {"lowerIsBetter": true, "replicates": [97.0, 98.0, 96.0, 96.0, 96.0, 97.0, 96.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.4}, {"lowerIsBetter": true, "replicates": [71.0, 72.0, 71.0, 71.0, 70.0, 73.0, 71.0, 70.0, 70.0, 69.0], "unit": "score", "name": "json-parse-financial", "value": 70.8}, {"lowerIsBetter": true, "replicates": [67.0, 69.0, 72.0, 67.0, 70.0, 69.0, 68.0, 69.0, 67.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.6}, {"lowerIsBetter": true, "replicates": [82.0, 83.0, 83.0, 84.0, 91.0, 84.0, 84.0, 92.0, 83.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.1}, {"lowerIsBetter": true, "replicates": [120.0, 126.0, 121.0, 135.0, 135.0, 123.0, 125.0, 127.0, 139.0, 122.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 127.3}, {"lowerIsBetter": true, "replicates": [139.0, 150.0, 149.0, 150.0, 146.0, 141.0, 146.0, 148.0, 158.0, 136.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 146.3}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 71.0, 71.0, 71.0, 71.0, 71.0, 73.0, 70.0, 70.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 71.3}], "name": "kraken", "value": 1546.7999999999995}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.0564650851988], "unit": "score", "name": "Richards", "value": 211.31777200000008}, {"lowerIsBetter": false, "replicates": [186.46280067126608], "unit": "score", "name": "DeltaBlue", "value": 354.59083400000003}, {"lowerIsBetter": false, "replicates": [278.2415136338342], "unit": "score", "name": "Encrypt", "value": 956.654514}, {"lowerIsBetter": false, "replicates": [5301.587301587301], "unit": "score", "name": "Decrypt", "value": 50.20779341317366}, {"lowerIsBetter": false, "replicates": [1077.502691065662], "unit": "score", "name": "RayTrace", "value": 686.7630179820178}, {"lowerIsBetter": false, "replicates": [723.589001447178], "unit": "score", "name": "Earley", "value": 921.051866}, {"lowerIsBetter": false, "replicates": [12884.615384615385], "unit": "score", "name": "Boyer", "value": 51.72548656716421}, {"lowerIsBetter": false, "replicates": [43340.425531914894], "unit": "score", "name": "RegExp", "value": 21.019290623465874}, {"lowerIsBetter": false, "replicates": [595.5926146515783], "unit": "score", "name": "Splay", "value": 136.82338900000002}, {"lowerIsBetter": false, "replicates": [4830.917874396136], "unit": "score", "name": "NavierStokes", "value": 307.1879999999999}], "name": "v8_7", "value": 20147.147969610243}]} 04:41:57 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,43]]", "result": "20147.15"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,43]]", "result": "1546.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,43]]", "result": "6158.29"}}} 04:41:57 INFO - Return code: 0 04:41:57 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 04:41:57 INFO - # TBPL SUCCESS # 04:41:57 INFO - Running post-action listener: _resource_record_post_action 04:41:57 INFO - Running post-run listener: _resource_record_post_run 04:41:58 INFO - Total resource usage - Wall time: 1237s; CPU: 13.0%; Read bytes: 0; Write bytes: 539336704; Read time: 0; Write time: 532372 04:41:58 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 231743488; Read time: 0; Write time: 271520 04:41:58 INFO - run-tests - Wall time: 1222s; CPU: 13.0%; Read bytes: 0; Write bytes: 307593216; Read time: 0; Write time: 260852 04:41:58 INFO - Running post-run listener: _upload_blobber_files 04:41:58 INFO - Blob upload gear active. 04:41:58 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:41:58 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 04:41:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:41:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:41:59 INFO - (blobuploader) - INFO - Open directory for files ... 04:41:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:41:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:41:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:42:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:42:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:42:00 INFO - (blobuploader) - INFO - Done attempting. 04:42:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:42:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:42:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:42:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:42:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:42:01 INFO - (blobuploader) - INFO - Done attempting. 04:42:01 INFO - (blobuploader) - INFO - Iteration through files over. 04:42:01 INFO - Return code: 0 04:42:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:42:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:42:01 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9cb32f4315065b7d631c771f85a0226599636bf2c2ecf8ec8171e3f02728b5cd5096bb522040483c7f6f829f5ca9b6719bdc9238914a574f3bd0131d8d5047c2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/02447010404ce1119a41b941af23f4f367ffd618165884a810f0c1a7dd8ac3e229a44a7edb5f0a5b46cbf00f22d151d6c843e71612c55bf59eafae1fd9cb0863"} 04:42:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:42:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:42:01 INFO - Contents: 04:42:01 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9cb32f4315065b7d631c771f85a0226599636bf2c2ecf8ec8171e3f02728b5cd5096bb522040483c7f6f829f5ca9b6719bdc9238914a574f3bd0131d8d5047c2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/02447010404ce1119a41b941af23f4f367ffd618165884a810f0c1a7dd8ac3e229a44a7edb5f0a5b46cbf00f22d151d6c843e71612c55bf59eafae1fd9cb0863"} 04:42:01 INFO - Copying logs to upload dir... 04:42:01 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1279.638649 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 19 secs) (at 2016-01-12 04:42:00.162354) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-12 04:42:00.165907) ========= 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=5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9cb32f4315065b7d631c771f85a0226599636bf2c2ecf8ec8171e3f02728b5cd5096bb522040483c7f6f829f5ca9b6719bdc9238914a574f3bd0131d8d5047c2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/02447010404ce1119a41b941af23f4f367ffd618165884a810f0c1a7dd8ac3e229a44a7edb5f0a5b46cbf00f22d151d6c843e71612c55bf59eafae1fd9cb0863"} build_url:https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011268 build_url: 'https://queue.taskcluster.net/v1/task/IVQdqOziSsuPbL-v4QhrhA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9cb32f4315065b7d631c771f85a0226599636bf2c2ecf8ec8171e3f02728b5cd5096bb522040483c7f6f829f5ca9b6719bdc9238914a574f3bd0131d8d5047c2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/02447010404ce1119a41b941af23f4f367ffd618165884a810f0c1a7dd8ac3e229a44a7edb5f0a5b46cbf00f22d151d6c843e71612c55bf59eafae1fd9cb0863"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-12 04:42:00.191890) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:42:00.192231) ========= 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=5cf47e208febbcd81da23b2e0000026f-1452601238.872162-1575189687 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004710 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-12 04:42:00.278507) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-12 04:42:00.278836) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-12 04:42:00.279129) ========= ========= Total master_lag: 0.24 =========