builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-030 starttime: 1467369868.76 results: success (0) buildid: 20160701021823 builduid: bd08576ca08b4d53902e853fbebc2079 revision: fdcee57b4e4f66a82831ab01e61500da98a858e8 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:28.763253) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:28.763764) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:28.764049) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:28.780261) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:28.780656) ========= 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=4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-01 03:44:28-- 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% 96.8M=0s 2016-07-01 03:44:29 (96.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.162245 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:28.957882) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:28.958218) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014742 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:29.008455) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:29.008838) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev fdcee57b4e4f66a82831ab01e61500da98a858e8 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev fdcee57b4e4f66a82831ab01e61500da98a858e8 --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=4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-01 03:44:29,156 truncating revision to first 12 chars 2016-07-01 03:44:29,156 Setting DEBUG logging. 2016-07-01 03:44:29,156 attempt 1/10 2016-07-01 03:44:29,156 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/fdcee57b4e4f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-01 03:44:29,566 unpacking tar archive at: mozilla-central-fdcee57b4e4f/testing/mozharness/ program finished with exit code 0 elapsedTime=0.765158 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:29.789165) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:29.789518) ========= script_repo_revision: fdcee57b4e4f66a82831ab01e61500da98a858e8 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:29.789935) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:29.790224) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-01 03:44:29.812309) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-07-01 03:44:29.812907) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-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', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-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=4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:44:30 INFO - MultiFileLogger online at 20160701 03:44:30 in /builds/slave/test 03:44:30 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 03:44:30 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:44:30 INFO - {'append_to_log': False, 03:44:30 INFO - 'base_work_dir': '/builds/slave/test', 03:44:30 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 03:44:30 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:44:30 INFO - 'branch': 'Firefox-Non-PGO', 03:44:30 INFO - 'buildbot_json_path': 'buildprops.json', 03:44:30 INFO - 'config_files': ('talos/linux_config.py',), 03:44:30 INFO - 'default_actions': ('clobber', 03:44:30 INFO - 'read-buildbot-config', 03:44:30 INFO - 'download-and-extract', 03:44:30 INFO - 'populate-webroot', 03:44:30 INFO - 'create-virtualenv', 03:44:30 INFO - 'install', 03:44:30 INFO - 'run-tests'), 03:44:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:44:30 INFO - 'download_minidump_stackwalk': True, 03:44:30 INFO - 'download_symbols': 'ondemand', 03:44:30 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:44:30 INFO - 'tooltool.py': '/tools/tooltool.py', 03:44:30 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:44:30 INFO - '/tools/misc-python/virtualenv.py')}, 03:44:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:44:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:44:30 INFO - 'installer_path': 'installer.exe', 03:44:30 INFO - 'log_level': 'info', 03:44:30 INFO - 'log_name': 'talos', 03:44:30 INFO - 'log_to_console': True, 03:44:30 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:44:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:44:30 INFO - 'opt_config_files': (), 03:44:30 INFO - 'pip_index': False, 03:44:30 INFO - 'sps_profile': False, 03:44:30 INFO - 'sps_profile_interval': 0, 03:44:30 INFO - 'suite': 'dromaeojs-e10s', 03:44:30 INFO - 'system_bits': '32', 03:44:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:44:30 INFO - 'title': 'talos-linux64-ix-030', 03:44:30 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:44:30 INFO - 'use_talos_json': True, 03:44:30 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:44:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:44:30 INFO - 'work_dir': 'build'} 03:44:30 INFO - ##### 03:44:30 INFO - ##### Running clobber step. 03:44:30 INFO - ##### 03:44:30 INFO - Running pre-action listener: _resource_record_pre_action 03:44:30 INFO - Running main action method: clobber 03:44:30 INFO - rmtree: /builds/slave/test/build 03:44:30 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:44:30 INFO - Running post-action listener: _resource_record_post_action 03:44:30 INFO - ##### 03:44:30 INFO - ##### Finished clobber step (success) 03:44:30 INFO - ##### 03:44:30 INFO - ##### 03:44:30 INFO - ##### Running read-buildbot-config step. 03:44:30 INFO - ##### 03:44:30 INFO - Running pre-action listener: _resource_record_pre_action 03:44:30 INFO - Running main action method: read_buildbot_config 03:44:30 INFO - Using buildbot properties: 03:44:30 INFO - { 03:44:30 INFO - "project": "", 03:44:30 INFO - "product": "firefox", 03:44:30 INFO - "script_repo_revision": "production", 03:44:30 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 03:44:30 INFO - "repository": "", 03:44:30 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 03:44:30 INFO - "buildid": "20160701021823", 03:44:30 INFO - "pgo_build": "False", 03:44:30 INFO - "basedir": "/builds/slave/test", 03:44:30 INFO - "buildnumber": 94, 03:44:30 INFO - "slavename": "talos-linux64-ix-030", 03:44:30 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 03:44:30 INFO - "platform": "ubuntu64_hw", 03:44:30 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 03:44:30 INFO - "branch": "mozilla-central", 03:44:30 INFO - "repo_path": "mozilla-central", 03:44:30 INFO - "revision": "fdcee57b4e4f66a82831ab01e61500da98a858e8", 03:44:30 INFO - "stage_platform": "linux64", 03:44:30 INFO - "builduid": "bd08576ca08b4d53902e853fbebc2079", 03:44:30 INFO - "slavebuilddir": "test" 03:44:30 INFO - } 03:44:30 INFO - Found installer url https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 03:44:30 INFO - Running post-action listener: _resource_record_post_action 03:44:30 INFO - ##### 03:44:30 INFO - ##### Finished read-buildbot-config step (success) 03:44:30 INFO - ##### 03:44:30 INFO - ##### 03:44:30 INFO - ##### Running download-and-extract step. 03:44:30 INFO - ##### 03:44:30 INFO - Running pre-action listener: _resource_record_pre_action 03:44:30 INFO - Running main action method: download_and_extract 03:44:30 INFO - mkdir: /builds/slave/test/build/tests 03:44:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:30 INFO - https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 03:44:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:44:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:44:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:44:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 03:44:31 INFO - Downloaded 1361 bytes. 03:44:31 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:44:31 INFO - Using the following test package requirements: 03:44:31 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 03:44:31 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:44:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 03:44:31 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:44:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 03:44:31 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:44:31 INFO - u'jsshell-linux-x86_64.zip'], 03:44:31 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:44:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 03:44:31 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 03:44:31 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:44:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 03:44:31 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:44:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 03:44:31 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:44:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 03:44:31 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:44:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 03:44:31 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:44:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:31 INFO - https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:44:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:44:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:44:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:44:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:44:32 INFO - Downloaded 22704200 bytes. 03:44:32 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:44:32 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 03:44:33 INFO - Return code: 0 03:44:33 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 03:44:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:33 INFO - https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:44:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:44:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:44:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:44:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:44:34 INFO - Downloaded 22704200 bytes. 03:44:34 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:44:34 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 03:44:35 INFO - Return code: 0 03:44:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:35 INFO - https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:44:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 03:44:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 03:44:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 03:44:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 03:44:36 INFO - Downloaded 14405242 bytes. 03:44:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:44:36 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 03:44:37 INFO - Return code: 0 03:44:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:37 INFO - https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:44:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:44:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:44:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:44:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 03:44:38 INFO - Downloaded 56445670 bytes. 03:44:38 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:44:38 INFO - mkdir: /builds/slave/test/properties 03:44:38 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:44:38 INFO - Writing to file /builds/slave/test/properties/build_url 03:44:38 INFO - Contents: 03:44:38 INFO - build_url:https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:44:39 INFO - Running post-action listener: _resource_record_post_action 03:44:39 INFO - Running post-action listener: set_extra_try_arguments 03:44:39 INFO - ##### 03:44:39 INFO - ##### Finished download-and-extract step (success) 03:44:39 INFO - ##### 03:44:39 INFO - ##### 03:44:39 INFO - ##### Running populate-webroot step. 03:44:39 INFO - ##### 03:44:39 INFO - Running pre-action listener: _resource_record_pre_action 03:44:39 INFO - Running main action method: populate_webroot 03:44:39 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:44:39 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:44:39 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:44:39 INFO - '--tppagecycles', 03:44:39 INFO - '7'], 03:44:39 INFO - 'tests': ['tsvgm']}}, 03:44:39 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:44:39 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:44:39 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:44:39 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:44:39 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:44:39 INFO - 'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:44:39 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:44:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:44:39 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:44:39 INFO - 'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['damp', 'tps']}, 03:44:39 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:44:39 INFO - 'tests': ['damp', 'tps']}, 03:44:39 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['dromaeo_dom']}, 03:44:39 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:44:39 INFO - 'g4': {'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['basic_compositor_video']}, 03:44:39 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 03:44:39 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['a11yr', 03:44:39 INFO - 'ts_paint', 03:44:39 INFO - 'tpaint', 03:44:39 INFO - 'sessionrestore', 03:44:39 INFO - 'sessionrestore_no_auto_restore', 03:44:39 INFO - 'tabpaint']}, 03:44:39 INFO - 'other-e10s': {'tests': ['a11yr', 03:44:39 INFO - 'ts_paint', 03:44:39 INFO - 'tpaint', 03:44:39 INFO - 'sessionrestore', 03:44:39 INFO - 'sessionrestore_no_auto_restore', 03:44:39 INFO - 'tabpaint']}, 03:44:39 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:44:39 INFO - 'ts_paint', 03:44:39 INFO - 'tpaint', 03:44:39 INFO - 'sessionrestore', 03:44:39 INFO - 'sessionrestore_no_auto_restore', 03:44:39 INFO - 'tabpaint']}, 03:44:39 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:44:39 INFO - 'ts_paint', 03:44:39 INFO - 'tpaint', 03:44:39 INFO - 'sessionrestore', 03:44:39 INFO - 'sessionrestore_no_auto_restore', 03:44:39 INFO - 'tabpaint']}, 03:44:39 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['a11yr', 03:44:39 INFO - 'ts_paint', 03:44:39 INFO - 'tpaint', 03:44:39 INFO - 'sessionrestore', 03:44:39 INFO - 'sessionrestore_no_auto_restore', 03:44:39 INFO - 'tabpaint']}, 03:44:39 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['a11yr', 03:44:39 INFO - 'ts_paint', 03:44:39 INFO - 'tpaint', 03:44:39 INFO - 'sessionrestore', 03:44:39 INFO - 'sessionrestore_no_auto_restore', 03:44:39 INFO - 'tabpaint']}, 03:44:39 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['tsvgx', 03:44:39 INFO - 'tsvgr_opacity', 03:44:39 INFO - 'tart', 03:44:39 INFO - 'tscrollx', 03:44:39 INFO - 'cart']}, 03:44:39 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:44:39 INFO - 'tsvgr_opacity', 03:44:39 INFO - 'tart', 03:44:39 INFO - 'tscrollx', 03:44:39 INFO - 'cart']}, 03:44:39 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:44:39 INFO - 'talos_options': ['--disable-e10s'], 03:44:39 INFO - 'tests': ['tp5o']}, 03:44:39 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:44:39 INFO - 'tests': ['tp5o']}, 03:44:39 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:44:39 INFO - 'talos_options': ['--disable-e10s', 03:44:39 INFO - '--xperf_path', 03:44:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:44:39 INFO - 'tests': ['tp5n']}, 03:44:39 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:44:39 INFO - 'talos_options': ['--xperf_path', 03:44:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:44:39 INFO - 'tests': ['tp5n']}}, 03:44:39 INFO - 'talos.zip': {'path': '', 03:44:39 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:44:39 INFO - Running post-action listener: _resource_record_post_action 03:44:39 INFO - ##### 03:44:39 INFO - ##### Finished populate-webroot step (success) 03:44:39 INFO - ##### 03:44:39 INFO - ##### 03:44:39 INFO - ##### Running create-virtualenv step. 03:44:39 INFO - ##### 03:44:39 INFO - Running pre-action listener: _resource_record_pre_action 03:44:39 INFO - Running main action method: create_virtualenv 03:44:39 INFO - Creating virtualenv /builds/slave/test/build/venv 03:44:39 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 03:44:39 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:44:39 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:44:39 INFO - Using real prefix '/usr' 03:44:39 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:44:39 INFO - Installing distribute.............................................................................................................................................................................................done. 03:44:41 INFO - Installing pip.................done. 03:44:41 INFO - Return code: 0 03:44:41 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:44:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:44:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:44:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:41 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:44:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 03:44:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 03:44:41 INFO - Using env: {'DISPLAY': ':0', 03:44:41 INFO - 'HOME': '/home/cltbld', 03:44:41 INFO - 'LANG': 'en_US.UTF-8', 03:44:41 INFO - 'LANGUAGE': 'en_US:en', 03:44:41 INFO - 'LOGNAME': 'cltbld', 03:44:41 INFO - 'MAIL': '/var/mail/cltbld', 03:44:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:44:41 INFO - 'MOZ_NO_REMOTE': '1', 03:44:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:44:41 INFO - 'NO_EM_RESTART': '1', 03:44:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:44:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:44:41 INFO - 'PWD': '/builds/slave/test', 03:44:41 INFO - 'SHELL': '/bin/bash', 03:44:41 INFO - 'SHLVL': '1', 03:44:41 INFO - 'TERM': 'linux', 03:44:41 INFO - 'TMOUT': '86400', 03:44:41 INFO - 'USER': 'cltbld', 03:44:41 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:44:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:44:41 INFO - '_': '/tools/buildbot/bin/python'} 03:44:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:44:41 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 03:44:41 INFO - Cleaning up... 03:44:41 INFO - Return code: 0 03:44:41 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:44:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:44:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:44:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:41 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:44:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 03:44:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 03:44:41 INFO - Using env: {'DISPLAY': ':0', 03:44:41 INFO - 'HOME': '/home/cltbld', 03:44:41 INFO - 'LANG': 'en_US.UTF-8', 03:44:41 INFO - 'LANGUAGE': 'en_US:en', 03:44:41 INFO - 'LOGNAME': 'cltbld', 03:44:41 INFO - 'MAIL': '/var/mail/cltbld', 03:44:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:44:41 INFO - 'MOZ_NO_REMOTE': '1', 03:44:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:44:41 INFO - 'NO_EM_RESTART': '1', 03:44:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:44:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:44:41 INFO - 'PWD': '/builds/slave/test', 03:44:41 INFO - 'SHELL': '/bin/bash', 03:44:41 INFO - 'SHLVL': '1', 03:44:41 INFO - 'TERM': 'linux', 03:44:41 INFO - 'TMOUT': '86400', 03:44:41 INFO - 'USER': 'cltbld', 03:44:41 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:44:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:44:41 INFO - '_': '/tools/buildbot/bin/python'} 03:44:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:44:42 INFO - Downloading/unpacking psutil>=3.1.1 03:44:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:44:44 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:44:44 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:44:44 INFO - Installing collected packages: psutil 03:44:44 INFO - Running setup.py install for psutil 03:44:44 INFO - building 'psutil._psutil_linux' extension 03:44:44 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 03:44:44 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 03:44:44 INFO - building 'psutil._psutil_posix' extension 03:44:44 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 03:44:44 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 03:44:44 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:44:44 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:44:44 INFO - Successfully installed psutil 03:44:44 INFO - Cleaning up... 03:44:44 INFO - Return code: 0 03:44:44 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:44:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:44:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:44:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:44:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 03:44:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 03:44:44 INFO - Using env: {'DISPLAY': ':0', 03:44:44 INFO - 'HOME': '/home/cltbld', 03:44:44 INFO - 'LANG': 'en_US.UTF-8', 03:44:44 INFO - 'LANGUAGE': 'en_US:en', 03:44:44 INFO - 'LOGNAME': 'cltbld', 03:44:44 INFO - 'MAIL': '/var/mail/cltbld', 03:44:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:44:44 INFO - 'MOZ_NO_REMOTE': '1', 03:44:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:44:44 INFO - 'NO_EM_RESTART': '1', 03:44:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:44:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:44:44 INFO - 'PWD': '/builds/slave/test', 03:44:44 INFO - 'SHELL': '/bin/bash', 03:44:44 INFO - 'SHLVL': '1', 03:44:44 INFO - 'TERM': 'linux', 03:44:44 INFO - 'TMOUT': '86400', 03:44:44 INFO - 'USER': 'cltbld', 03:44:44 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:44:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:44:44 INFO - '_': '/tools/buildbot/bin/python'} 03:44:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:44:44 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:44:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:46 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:44:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:44:46 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:44:46 INFO - Installing collected packages: mozsystemmonitor 03:44:46 INFO - Running setup.py install for mozsystemmonitor 03:44:46 INFO - Successfully installed mozsystemmonitor 03:44:46 INFO - Cleaning up... 03:44:47 INFO - Return code: 0 03:44:47 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:44: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')]} 03:44:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:44:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44: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')]} 03:44:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:44:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:44:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 03:44:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 03:44:47 INFO - Using env: {'DISPLAY': ':0', 03:44:47 INFO - 'HOME': '/home/cltbld', 03:44:47 INFO - 'LANG': 'en_US.UTF-8', 03:44:47 INFO - 'LANGUAGE': 'en_US:en', 03:44:47 INFO - 'LOGNAME': 'cltbld', 03:44:47 INFO - 'MAIL': '/var/mail/cltbld', 03:44:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:44:47 INFO - 'MOZ_NO_REMOTE': '1', 03:44:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:44:47 INFO - 'NO_EM_RESTART': '1', 03:44:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:44:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:44:47 INFO - 'PWD': '/builds/slave/test', 03:44:47 INFO - 'SHELL': '/bin/bash', 03:44:47 INFO - 'SHLVL': '1', 03:44:47 INFO - 'TERM': 'linux', 03:44:47 INFO - 'TMOUT': '86400', 03:44:47 INFO - 'USER': 'cltbld', 03:44:47 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:44:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:44:47 INFO - '_': '/tools/buildbot/bin/python'} 03:44:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:44:47 INFO - Downloading/unpacking jsonschema==2.5.1 03:44:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:49 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:44:49 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:44:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:49 INFO - Downloading functools32-3.2.3-2.tar.gz 03:44:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:44:49 INFO - warning: no files found matching '*.txt' 03:44:49 INFO - no previously-included directories found matching 'build' 03:44:49 INFO - no previously-included directories found matching 'dist' 03:44:49 INFO - no previously-included directories found matching '.git*' 03:44:49 INFO - Installing collected packages: jsonschema, functools32 03:44:49 INFO - Running setup.py install for functools32 03:44:49 INFO - warning: no files found matching '*.txt' 03:44:49 INFO - no previously-included directories found matching 'build' 03:44:49 INFO - no previously-included directories found matching 'dist' 03:44:49 INFO - no previously-included directories found matching '.git*' 03:44:49 INFO - Successfully installed jsonschema functools32 03:44:49 INFO - Cleaning up... 03:44:49 INFO - Return code: 0 03:44:49 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:44:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:44:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:44:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:44:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 03:44:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 03:44:49 INFO - Using env: {'DISPLAY': ':0', 03:44:49 INFO - 'HOME': '/home/cltbld', 03:44:49 INFO - 'LANG': 'en_US.UTF-8', 03:44:49 INFO - 'LANGUAGE': 'en_US:en', 03:44:49 INFO - 'LOGNAME': 'cltbld', 03:44:49 INFO - 'MAIL': '/var/mail/cltbld', 03:44:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:44:49 INFO - 'MOZ_NO_REMOTE': '1', 03:44:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:44:49 INFO - 'NO_EM_RESTART': '1', 03:44:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:44:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:44:49 INFO - 'PWD': '/builds/slave/test', 03:44:49 INFO - 'SHELL': '/bin/bash', 03:44:49 INFO - 'SHLVL': '1', 03:44:49 INFO - 'TERM': 'linux', 03:44:49 INFO - 'TMOUT': '86400', 03:44:49 INFO - 'USER': 'cltbld', 03:44:49 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:44:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:44:49 INFO - '_': '/tools/buildbot/bin/python'} 03:44:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:44:49 INFO - Downloading/unpacking blobuploader==1.2.4 03:44:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:51 INFO - Downloading blobuploader-1.2.4.tar.gz 03:44:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:44:51 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:44:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:44:52 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:44:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:52 INFO - Downloading docopt-0.6.1.tar.gz 03:44:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:44:52 INFO - Installing collected packages: blobuploader, requests, docopt 03:44:52 INFO - Running setup.py install for blobuploader 03:44:52 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:44:52 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:44:52 INFO - Running setup.py install for requests 03:44:52 INFO - Running setup.py install for docopt 03:44:53 INFO - Successfully installed blobuploader requests docopt 03:44:53 INFO - Cleaning up... 03:44:53 INFO - Return code: 0 03:44:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:44: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')]} 03:44:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:44:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44: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')]} 03:44:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:44:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:44:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:44:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:44:53 INFO - Using env: {'DISPLAY': ':0', 03:44:53 INFO - 'HOME': '/home/cltbld', 03:44:53 INFO - 'LANG': 'en_US.UTF-8', 03:44:53 INFO - 'LANGUAGE': 'en_US:en', 03:44:53 INFO - 'LOGNAME': 'cltbld', 03:44:53 INFO - 'MAIL': '/var/mail/cltbld', 03:44:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:44:53 INFO - 'MOZ_NO_REMOTE': '1', 03:44:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:44:53 INFO - 'NO_EM_RESTART': '1', 03:44:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:44:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:44:53 INFO - 'PWD': '/builds/slave/test', 03:44:53 INFO - 'SHELL': '/bin/bash', 03:44:53 INFO - 'SHLVL': '1', 03:44:53 INFO - 'TERM': 'linux', 03:44:53 INFO - 'TMOUT': '86400', 03:44:53 INFO - 'USER': 'cltbld', 03:44:53 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:44:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:44:53 INFO - '_': '/tools/buildbot/bin/python'} 03:44:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:44:53 INFO - Running setup.py (path:/tmp/pip-szDnph-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:44:53 INFO - Running setup.py (path:/tmp/pip-gdhPjh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:44:53 INFO - Running setup.py (path:/tmp/pip-NEOpRv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:44:53 INFO - Running setup.py (path:/tmp/pip-swCNdS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:44:53 INFO - Running setup.py (path:/tmp/pip-N5TGks-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:44:53 INFO - Running setup.py (path:/tmp/pip-Fy80zF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:44:53 INFO - Running setup.py (path:/tmp/pip-Aj26hj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:44:53 INFO - Running setup.py (path:/tmp/pip-cUXWSR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:44:53 INFO - Running setup.py (path:/tmp/pip-gn3Yci-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:44:53 INFO - Running setup.py (path:/tmp/pip-XwryHT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:44:54 INFO - Running setup.py (path:/tmp/pip-idZjhu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:44:54 INFO - Running setup.py (path:/tmp/pip-Wf9pX8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:44:54 INFO - Running setup.py (path:/tmp/pip-E0eb8X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:44:54 INFO - Running setup.py (path:/tmp/pip-eft0bx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:44:54 INFO - Running setup.py (path:/tmp/pip-r0nzcq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:44:54 INFO - Running setup.py (path:/tmp/pip-gBu3Gt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:44:54 INFO - Running setup.py (path:/tmp/pip-CO3NxH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:44:54 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:44:54 INFO - Running setup.py install for manifestparser 03:44:54 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:44:54 INFO - Running setup.py install for mozcrash 03:44:54 INFO - Running setup.py install for mozdebug 03:44:54 INFO - Running setup.py install for mozdevice 03:44:54 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:44:54 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:44:54 INFO - Running setup.py install for mozfile 03:44:55 INFO - Running setup.py install for mozhttpd 03:44:55 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Running setup.py install for mozinfo 03:44:55 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Running setup.py install for mozInstall 03:44:55 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Running setup.py install for mozleak 03:44:55 INFO - Running setup.py install for mozlog 03:44:55 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Running setup.py install for moznetwork 03:44:55 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Running setup.py install for mozprocess 03:44:55 INFO - Running setup.py install for mozprofile 03:44:55 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:44:55 INFO - Running setup.py install for mozrunner 03:44:55 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:44:56 INFO - Running setup.py install for mozscreenshot 03:44:56 INFO - Running setup.py install for moztest 03:44:56 INFO - Running setup.py install for mozversion 03:44:56 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:44:56 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:44:56 INFO - Cleaning up... 03:44:56 INFO - Return code: 0 03:44:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:44:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:44:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:44:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:44:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:44:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:44:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:44:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:44:56 INFO - Using env: {'DISPLAY': ':0', 03:44:56 INFO - 'HOME': '/home/cltbld', 03:44:56 INFO - 'LANG': 'en_US.UTF-8', 03:44:56 INFO - 'LANGUAGE': 'en_US:en', 03:44:56 INFO - 'LOGNAME': 'cltbld', 03:44:56 INFO - 'MAIL': '/var/mail/cltbld', 03:44:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:44:56 INFO - 'MOZ_NO_REMOTE': '1', 03:44:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:44:56 INFO - 'NO_EM_RESTART': '1', 03:44:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:44:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:44:56 INFO - 'PWD': '/builds/slave/test', 03:44:56 INFO - 'SHELL': '/bin/bash', 03:44:56 INFO - 'SHLVL': '1', 03:44:56 INFO - 'TERM': 'linux', 03:44:56 INFO - 'TMOUT': '86400', 03:44:56 INFO - 'USER': 'cltbld', 03:44:56 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:44:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:44:56 INFO - '_': '/tools/buildbot/bin/python'} 03:44:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:44:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:44:56 INFO - Running setup.py (path:/tmp/pip-87wudg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:44:56 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 03:44:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:44:56 INFO - Running setup.py (path:/tmp/pip-fLXTvJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:44:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:44:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:44:56 INFO - Running setup.py (path:/tmp/pip-kJmcDK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:44:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:44:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:44:56 INFO - Running setup.py (path:/tmp/pip-dMPnwt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:44:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:44:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:44:56 INFO - Running setup.py (path:/tmp/pip-PV1tND-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:44:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 03:44:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:44:56 INFO - Running setup.py (path:/tmp/pip-UkHEF3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:44:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 03:44:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:44:56 INFO - Running setup.py (path:/tmp/pip-o83IGu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:44:57 INFO - Running setup.py (path:/tmp/pip-Gi3aSu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:44:57 INFO - Running setup.py (path:/tmp/pip-8GSh0_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:44:57 INFO - Running setup.py (path:/tmp/pip-kPosIa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:44:57 INFO - Running setup.py (path:/tmp/pip-AHwm0K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:44:57 INFO - Running setup.py (path:/tmp/pip-llTzcB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:44:57 INFO - Running setup.py (path:/tmp/pip-KcG2Mc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:44:57 INFO - Running setup.py (path:/tmp/pip-iWccDd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:44:57 INFO - Running setup.py (path:/tmp/pip-q9T4zv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:44:57 INFO - Running setup.py (path:/tmp/pip-JuM1oI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 03:44:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:44:57 INFO - Running setup.py (path:/tmp/pip-sHTqTq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:44:57 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:44:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:44:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:44:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:44:59 INFO - Downloading blessings-1.6.tar.gz 03:44:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:44:59 INFO - Installing collected packages: blessings 03:44:59 INFO - Running setup.py install for blessings 03:44:59 INFO - Successfully installed blessings 03:44:59 INFO - Cleaning up... 03:44:59 INFO - Return code: 0 03:44:59 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:44:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:44:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:45:00 INFO - Reading from file tmpfile_stdout 03:45:00 INFO - Current package versions: 03:45:00 INFO - argparse == 1.2.1 03:45:00 INFO - blessings == 1.6 03:45:00 INFO - blobuploader == 1.2.4 03:45:00 INFO - docopt == 0.6.1 03:45:00 INFO - functools32 == 3.2.3-2 03:45:00 INFO - jsonschema == 2.5.1 03:45:00 INFO - manifestparser == 1.1 03:45:00 INFO - mozInstall == 1.12 03:45:00 INFO - mozcrash == 0.17 03:45:00 INFO - mozdebug == 0.1 03:45:00 INFO - mozdevice == 0.48 03:45:00 INFO - mozfile == 1.2 03:45:00 INFO - mozhttpd == 0.7 03:45:00 INFO - mozinfo == 0.9 03:45:00 INFO - mozleak == 0.1 03:45:00 INFO - mozlog == 3.2 03:45:00 INFO - moznetwork == 0.27 03:45:00 INFO - mozprocess == 0.22 03:45:00 INFO - mozprofile == 0.28 03:45:00 INFO - mozrunner == 6.11 03:45:00 INFO - mozscreenshot == 0.1 03:45:00 INFO - mozsystemmonitor == 0.3 03:45:00 INFO - moztest == 0.7 03:45:00 INFO - mozversion == 1.4 03:45:00 INFO - psutil == 3.1.1 03:45:00 INFO - requests == 1.2.3 03:45:00 INFO - wsgiref == 0.1.2 03:45:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:45:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:45:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:45:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:45:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:45:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:45:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:45:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:45:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 03:45:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:45:00 INFO - Using env: {'DISPLAY': ':0', 03:45:00 INFO - 'HOME': '/home/cltbld', 03:45:00 INFO - 'LANG': 'en_US.UTF-8', 03:45:00 INFO - 'LANGUAGE': 'en_US:en', 03:45:00 INFO - 'LOGNAME': 'cltbld', 03:45:00 INFO - 'MAIL': '/var/mail/cltbld', 03:45:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:45:00 INFO - 'MOZ_NO_REMOTE': '1', 03:45:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:45:00 INFO - 'NO_EM_RESTART': '1', 03:45:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:45:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:45:00 INFO - 'PWD': '/builds/slave/test', 03:45:00 INFO - 'SHELL': '/bin/bash', 03:45:00 INFO - 'SHLVL': '1', 03:45:00 INFO - 'TERM': 'linux', 03:45:00 INFO - 'TMOUT': '86400', 03:45:00 INFO - 'USER': 'cltbld', 03:45:00 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:45:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:45:00 INFO - '_': '/tools/buildbot/bin/python'} 03:45:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:45:00 INFO - Cleaning up... 03:45:00 INFO - Return code: 0 03:45:00 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:45:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:45:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:45:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:45:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:45:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:45:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:45:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a50030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bb38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c7f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, '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': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:45:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 03:45:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 03:45:00 INFO - Using env: {'DISPLAY': ':0', 03:45:00 INFO - 'HOME': '/home/cltbld', 03:45:00 INFO - 'LANG': 'en_US.UTF-8', 03:45:00 INFO - 'LANGUAGE': 'en_US:en', 03:45:00 INFO - 'LOGNAME': 'cltbld', 03:45:00 INFO - 'MAIL': '/var/mail/cltbld', 03:45:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:45:00 INFO - 'MOZ_NO_REMOTE': '1', 03:45:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:45:00 INFO - 'NO_EM_RESTART': '1', 03:45:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:45:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:45:00 INFO - 'PWD': '/builds/slave/test', 03:45:00 INFO - 'SHELL': '/bin/bash', 03:45:00 INFO - 'SHLVL': '1', 03:45:00 INFO - 'TERM': 'linux', 03:45:00 INFO - 'TMOUT': '86400', 03:45:00 INFO - 'USER': 'cltbld', 03:45:00 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:45:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:45:00 INFO - '_': '/tools/buildbot/bin/python'} 03:45:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:45:00 INFO - Cleaning up... 03:45:00 INFO - Return code: 0 03:45:00 INFO - Running post-action listener: _resource_record_post_action 03:45:00 INFO - Running post-action listener: _start_resource_monitoring 03:45:00 INFO - Starting resource monitoring. 03:45:00 INFO - ##### 03:45:00 INFO - ##### Finished create-virtualenv step (success) 03:45:00 INFO - ##### 03:45:00 INFO - ##### 03:45:00 INFO - ##### Running install step. 03:45:00 INFO - ##### 03:45:00 INFO - Running pre-action listener: _resource_record_pre_action 03:45:00 INFO - Running main action method: install 03:45:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:45:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:45:00 INFO - Reading from file tmpfile_stdout 03:45:00 INFO - Detecting whether we're running mozinstall >=1.0... 03:45:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:45:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:45:00 INFO - Reading from file tmpfile_stdout 03:45:00 INFO - Output received: 03:45:00 INFO - Usage: mozinstall [options] installer 03:45:00 INFO - Options: 03:45:00 INFO - -h, --help show this help message and exit 03:45:00 INFO - -d DEST, --destination=DEST 03:45:00 INFO - Directory to install application into. [default: 03:45:00 INFO - "/builds/slave/test"] 03:45:00 INFO - --app=APP Application being installed. [default: firefox] 03:45:00 INFO - mkdir: /builds/slave/test/build/application 03:45:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 03:45:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 03:45:17 INFO - Reading from file tmpfile_stdout 03:45:17 INFO - Output received: 03:45:17 INFO - /builds/slave/test/build/application/firefox/firefox 03:45:17 INFO - Running post-action listener: _resource_record_post_action 03:45:17 INFO - ##### 03:45:17 INFO - ##### Finished install step (success) 03:45:17 INFO - ##### 03:45:17 INFO - ##### 03:45:17 INFO - ##### Running run-tests step. 03:45:17 INFO - ##### 03:45:17 INFO - Running pre-action listener: _resource_record_pre_action 03:45:17 INFO - Running main action method: run_tests 03:45:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:45:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:45:17 INFO - Python 2.7.3 03:45:17 INFO - Return code: 0 03:45:17 INFO - grabbing minidump binary from tooltool 03:45:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:45:17 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d0e570>, '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 0x2d0f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d0f900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:45:17 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 03:45:17 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 03:45:17 INFO - Calling ['/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'] with output_timeout 600 03:45:17 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:45:17 INFO - Return code: 0 03:45:17 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:45:17 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:45:17 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:45:17 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:45:17 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:45:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 03:45:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-030 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 03:45:17 INFO - Using env: {'DISPLAY': ':0', 03:45:17 INFO - 'HOME': '/home/cltbld', 03:45:17 INFO - 'LANG': 'en_US.UTF-8', 03:45:17 INFO - 'LANGUAGE': 'en_US:en', 03:45:17 INFO - 'LOGNAME': 'cltbld', 03:45:17 INFO - 'MAIL': '/var/mail/cltbld', 03:45:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:45:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:45:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:45:17 INFO - 'MOZ_NO_REMOTE': '1', 03:45:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:45:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:45:17 INFO - 'NO_EM_RESTART': '1', 03:45:17 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:45:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:45:17 INFO - 'PWD': '/builds/slave/test', 03:45:17 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:45:17 INFO - 'SHELL': '/bin/bash', 03:45:17 INFO - 'SHLVL': '1', 03:45:17 INFO - 'TERM': 'linux', 03:45:17 INFO - 'TMOUT': '86400', 03:45:17 INFO - 'USER': 'cltbld', 03:45:17 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463', 03:45:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:45:17 INFO - '_': '/tools/buildbot/bin/python'} 03:45:17 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 03:45:17 INFO - mozversion application_buildid: 20160701021823 03:45:17 INFO - mozversion application_changeset: fdcee57b4e4f66a82831ab01e61500da98a858e8 03:45:17 INFO - mozversion application_display_name: Nightly 03:45:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:45:17 INFO - mozversion application_name: Firefox 03:45:17 INFO - mozversion application_remotingname: firefox 03:45:17 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 03:45:17 INFO - mozversion application_vendor: Mozilla 03:45:17 INFO - mozversion application_version: 50.0a1 03:45:17 INFO - mozversion platform_buildid: 20160701021823 03:45:17 INFO - mozversion platform_changeset: fdcee57b4e4f66a82831ab01e61500da98a858e8 03:45:17 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 03:45:17 INFO - mozversion platform_version: 50.0a1 03:45:17 INFO - using testdate: 1467369917 03:45:17 INFO - actual date: 1467369917 03:45:17 INFO - starting webserver on 'localhost:50467' 03:45:17 INFO - SUITE-START | Running 2 tests 03:45:17 INFO - TEST-START | dromaeo_css 03:45:17 INFO - operating with platform_type : linux_ 03:45:17 INFO - Initialising browser for dromaeo_css test... 03:45:17 INFO - TEST-INFO | started process 10975 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpckV9TP/profile http://localhost:50467/getInfo.html) 03:45:22 INFO - PROCESS | 10975 | __metrics Screen width/height:1600/1200 03:45:22 INFO - PROCESS | 10975 | colorDepth:24 03:45:22 INFO - PROCESS | 10975 | Browser inner width/height: 1024/697 03:45:22 INFO - PROCESS | 10975 | __metrics 03:45:22 ERROR - PROCESS | 10975 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 03:45:23 INFO - TEST-INFO | 10975: exit 0 03:45:23 INFO - Browser initialized. 03:45:23 INFO - Running cycle 1/1 for dromaeo_css test... 03:45:23 INFO - TEST-INFO | started process 11094 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpckV9TP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:45:35 INFO - PROCESS | 11094 | RSS: Main: 169480192 03:45:35 INFO - PROCESS | 11094 | 03:46:25 INFO - PROCESS | 11094 | 1467369985196 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 03:48:37 INFO - PROCESS | 11094 | Cycle 1(1): loaded http://localhost:50467/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50467/tests/dromaeo/cssquery-ext.html) 03:48:38 INFO - PROCESS | 11094 | RSS: Main: 169717760 03:48:38 INFO - PROCESS | 11094 | 03:51:40 INFO - PROCESS | 11094 | Cycle 1(1): loaded http://localhost:50467/tests/dromaeo/cssquery-ext.html (next: http://localhost:50467/tests/dromaeo/cssquery-jquery.html) 03:51:41 INFO - PROCESS | 11094 | RSS: Main: 169467904 03:51:41 INFO - PROCESS | 11094 | 03:54:43 INFO - PROCESS | 11094 | Cycle 1(1): loaded http://localhost:50467/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50467/tests/dromaeo/cssquery-mootools.html) 03:54:43 INFO - PROCESS | 11094 | RSS: Main: 172412928 03:54:43 INFO - PROCESS | 11094 | 03:57:45 INFO - PROCESS | 11094 | Cycle 1(1): loaded http://localhost:50467/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50467/tests/dromaeo/cssquery-prototype.html) 03:57:46 INFO - PROCESS | 11094 | RSS: Main: 167579648 03:57:46 INFO - PROCESS | 11094 | 04:00:48 INFO - PROCESS | 11094 | Cycle 1(1): loaded http://localhost:50467/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50467/tests/dromaeo/cssquery-yui.html) 04:00:49 INFO - PROCESS | 11094 | RSS: Main: 170397696 04:00:49 INFO - PROCESS | 11094 | 04:03:51 INFO - PROCESS | 11094 | Cycle 1(1): loaded http://localhost:50467/tests/dromaeo/cssquery-yui.html (next: http://localhost:50467/tests/dromaeo/cssquery-dojo.html) 04:03:52 INFO - PROCESS | 11094 | RSS: Main: 171024384 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - PROCESS | 11094 | __start_tp_report 04:03:52 INFO - PROCESS | 11094 | _x_x_mozilla_page_load 04:03:52 INFO - PROCESS | 11094 | _x_x_mozilla_page_load_details 04:03:52 INFO - PROCESS | 11094 | |i|pagename|runs| 04:03:52 INFO - PROCESS | 11094 | |0;dojo.html;2639.326971622236;2666.9333266668336;2678.049292501162;2678.812483126182;2680.3969106950926;4722.315264286676;4724.598409135223;4785.210440277355;4840.56434920857;4878.975605121969;4744.478107408182;4872.585830204437;4881.41423029237;4903.485134060926;5025.195968645017;4420.9115817683705;4438.644908407319;4484.439445069366;4579.427571553556;4602.769861506911;4254.744715317091;4529.909401811962;4582.495925448198;4635.443746750378;4644.60520855726;4350.32569951658;4388.451443569554;4414.955850441486;4520.276755719102;4521.389612402317;4448.021435284265;4456.3538286948215;4460.50934397216;4468.352088947117;4486.730796152241;4414.536473670282;4435.844745433927;4451.732896026248;4458.754768487732;4461.018575913294;4796.5683088521855;4817.084753896748;4836.758162091881;4838.104950584118;4864.8297309594345;5190.506901844319;5207.739613019334;5214.243934629458;5224.660397074178;5265;5104.897902041976;5200.271961925334;5222.608304377149;5244.082285600005;5261.579073674096;4842.709437433765;4877.3903262092235;4885.780139893714;4905.852824415273;4920.6555541111775;5361.356637203483;5376.542993845567;5392.083345831218;5407.432219616962;5457.672539647634;5015.448300686921;5095.719735414587;5143.871403214875;5144.202648589475;5156.381234251914;5099.388073431212;5213.817516386908;5244.606654500928;5258.2375555544995;5303.390110137307;5061.848144555669;5160.92258616121;5175.534201921845;5175.9741201293755;5190.558802501754;5124.333836601218;5132.538071573576;5136.691798492103;5155.072087024371;5173.793048278027;4059.127287633173;4112.033672087057;4118.5263694674895;4123.876283711494;4125.092479654471;3658.835352409148;3676.7426280160666;3698.2418604186078;3702.55600315877;3705.5182826232417;4440.089781594766;4444.28891377378;4501.392312037833;4511.142882852313;4597.793099310539;5246.370435547682;5283.815066472655;5292.047431462373;5305.469453054664;5311.415744268127;4538.614217791459;4544.613707834871;4549.909001820011;4578.313253012075;4586.2661974083985;4602.171609110325;4644.233701439225;4688;4709.987352719113;4710.646701497401;4861.708297502161;4885.65800393969;4896.2166053430565;4899.289603007615;4948.05986862495;5128.153854613947;5255.737213139251;5281;5301.727585379558;5306.469353064663;4872.707637541759;4882.511748825089;4921.6062714982;4944.950550494449;4953.7523123844385;5184;5195.7142357170715;5200.60995425337;5209.869753256199;5242.449542797951;5158.3552055993005;5220.504052115043;5273.156294992783;5277.997180535686;5289.9471005291;5046.520580544842;5071.0872043032605;5132.486751324837;5135.2553879687985;5153.948460515347;5058.443571207238;5109.846704598868;5113.284140220447;5124.5131712487255;5136.101182293009;4853.49038350968;4955.975220123876;5041.974790126026;5058.089543882136;5064.037832811754;5011.223260394645;5076.619253556072;5090;5094.898102037864;5127.359080114986;5029.145045342374;5050.545450909436;5072.847814565569;5081.923771143362;5097.158968770112 04:03:52 INFO - PROCESS | 11094 | |1;ext.html;542.5361316074756;570.178942323055;573.286258608033;577.1948132355365;587.74726867447;29302.706972930264;40412.39381409278;41354.58645413545;41559.16881662365;41755.164896702125;37851.62148378515;38288.617113828856;38431.80784096083;38446;38468;7777.183395743436;7918.762437126896;7941.28528432441;7941.920580794204;7958.721444749435;7770.300672939435;7827.569483678395;7852.607369631524;7893.368530517573;7896.802579935519;7904.960475197616;7906.723264685737;7913.802154946144;7918.32694220989;7922.643481043338;7862.567558784264;7874.2913137817295;7897.644605992744;7926.8810967835525;7936.166702496242;7874.330681892046;7918.6436610352675;7934.365250779923;7935.444518883681;7952.403569732235;39450.21099578021;39577.80211098926;39626.801865990485;39758;39810.60189398127;3100.6441023600464;3219.114743445571;3229.83850807461;3238.5142228665654;3565.982170089159;29153.56269655957;29162.70837291621;29358.266043348875;30195.396092078256;30298;3374.223928496435;3421.4354631485776;3444.2594842109065;3493.266414053052;3496.8251587420527;241786;242298;242892;243128;244668.77665611735;29748;54586.727066364416;54930.725346373016;55051;55186.448135518134;31189.688103119133;32822;32866.67133328684;32968.67031329704;33013;12231.204971676812;12232.266064036186;12274.079444041732;12298.754024919452;12320.691982700504;10710.03609675133;10727.678169654922;10744.033037026706;10767.515461804238;10789.028987391173;7874.409419293576;7969.402294827911;7984.960075199587;8052.194780522018;8081.515109093473;3120.7347375472887;3140.775097711894;3141.68583141684;3187.792793468417;3218.1954511372155;936.7751739582451;953.1755031897359;955.1833182628891;973.9415635061919;984.2322988069318;28429.71570284312;28556.571651425245;28576.714232857823;29070;29536.977172129365;943.5942544705842;945.9621615135318;976.2677991506371;1007.1489591295343;1028.8713910761155;14947.775783363259;15206;15225.847741522664;15385;15439.922800385926;421402;424285;425025;425624;426649;49910.752231194514;50106.49893501091;50148;50459.49540504621;50587.241191382156;1165.2891736041008;1170.8653504847052;1205.8613259475096;1208.323338930202;1213.6844420450745;26361.472770544864;27809.304767380978;27976;28146.2963425916;28267.43465130727;42154.36768448415;42370;42571.14857702766;42741;42909;359867;360013;360957;363130;364495;25496.23511294664;25842.095526656478;26045;26198.73801261963;26779;41747.7912610435;42300.57699422966;42458.36312455254;42519.3622095675;42812.78593607012;36516.452253216754;37102.25795484129;37138.814305928296;37196.81401593083;37312.626873730915;36564.268714625025;37158.25683486369;37677.62322376741;37789.05527361728;38139.80930095332;35675.82162089173;36343.818280908425;36476.63523364732;36881;37087.81456092702;32233.838830805696;32614.34771304608;33569.83215083909;33593.66406335905;33710.83144584359;25441.491170176123;25900;25940;26061.609075864257;26456 04:03:52 INFO - PROCESS | 11094 | |2;jquery.html;369.1693689199301;371.3167771300806;372.3558244237469;377.33588883564937;383.1379396358194;16234.188290585467;16958.40645577405;17593.56016099598;17598.82401175988;17642.558936026606;16235.594110147253;16778.244978975945;17962.461126166203;18013.549661258443;18026.369077082305;4624.537546245366;4818.25317075852;4850.927236091461;4853.441854186761;4858.149823780842;3555.839987200582;4776.617870570346;5261.316028916235;5546.972265138668;5554.1391084381785;5549.722513874311;5551.3893471718075;5569.66582005079;5614.6631202128;5632.239647647577;5509.173623956399;5590.077637189859;5594;5605.607607467479;5609.719514024282;5273.446288139767;5412.648177868426;5418.783248670048;5424.972875135599;5425.810096646638;21080.683789743165;21816;21848.12607495698;22045.559088818296;22119.668204976937;1746.1724656592787;1913.2538310059088;2042.7650820155723;2165.9783402165936;2327.487952650414;9133.086691330815;9369.156775890135;9418.529073546295;9549.140577348002;9595.04049595042;1690.4421540891476;1700;1759.384215524569;1809.8959634623002;1822.571695651521;67008;67017.66491167562;68183.31816681869;68209.31790682129;68746;9874.802503950024;10148.441835698959;10245.897541024644;10270.383776973405;10532.894671053346;14151.221682807545;14153;14211.50259740904;14226.28868556568;14272.286385680674;6803.965980170166;6932.202796678446;7008.614526201006;7047.471439641945;7054.6472676367;6347.809565713036;6410.839729006812;6413.358664133642;6535.444487218545;6593.142891424084;4325.6106950374615;4392.9121417572105;4406.801693923781;4452.933206001912;4494.73031618104;1681.8990860548406;1717.9226934787964;1839.814422189503;1867.3837633580886;1875.5873707784265;860;864.740577826662;881.532787622561;921.9216366608913;927.1284992107533;17030.74453883193;17038.57403564921;18041.819581804277;18678.439646810617;18928.33750818715;855.2003876375485;861.2765277167209;884.9247813935759;935.6351023100996;954.4680787336364;9855;10204.183665306758;10239.897601024044;10270.743231419125;10310.43292618913;408396;409800;415638;423979;426470;53495;76477.235227647;84474.57762711147;84896;89022.55488722515;911.4303560274828;919.8475567172715;925.9351845370759;954.7613096725819;961.3895176562793;13066.934665326613;15483.148426836633;16411;16483.34066637321;17003.659926801643;37659.81170094132;39562;39746.40380394354;40952.38571421371;41681;56727.43272567387;56782.43217567771;57275.42724572701;57451;58079.419205807404;7754.844903102019;7761.92238077612;7779.377649788116;7788.493747906368;7828.138904720362;8182.959085204536;11158.665240042812;11209.607663731731;11765.47055382527;11930.045596352098;9525.761855953378;9754.658586949423;9760.511974401394;9888.406695598287;10023.69928902134;9741.756456088655;10239.232057595562;10297.3821570706;10432.321899076536;10645.414502202453;9993.400395976265;10235.692929212135;10363.637272695722;10431.426271555138;10504;6549.31232220629;6948.374646281859;7843.058832940083;7848.097468790934;7856.057273127261;8998.55007249648;9911.702648920544;9977.62196031616;10132.544035518273;10659.840102398626 04:03:52 INFO - PROCESS | 11094 | |3;mootools.html;1368.5073373585508;1405.381632081884;1478.8373278939314;1688.7804585403896;1706.4198172621313;7040.542364746288;7665.501742386741;7679.884801727979;8174.2234487723645;8187.754367368981;7779.144294127642;7975.361971042317;8018.318442932343;8052.63763130659;8057.073436554798;2215.4461384653796;2243.730752309725;2246.7191601049867;2246.932592022242;2246.9887650561723;2159.136345461812;2204.2946257197705;2205.5037616536233;2205.7022301989186;2215.1582398688474;2216.0803266644402;2222.4443889027743;2230.1413955627118;2232.9776702232934;2243.887805609721;2156.1267686586957;2187.1688758271835;2189.868607883532;2192.6710993351044;2196.9450763730874;2143.582001509706;2155.859869108503;2160.83793715472;2167.981048907011;2169.175713228963;7990.760277191694;8076.959615201945;8090.231428014329;8116.228958248957;8144.959275203586;4393.055493068973;4508.909821803545;4515.954840451619;4518.5481451854885;4521.253993091136;2954.5715871198554;2965.6589492208454;2973.43504734102;2994.7604191664614;3076.4616192166504;932.7108596335158;957.3585697582637;958.7315551645551;972.6060945317158;984.4683870709808;11066.889331106666;11092.279001864934;11096;11112.611058612909;11117.666470005914;4032.7177097602885;4236.152769446123;4300.204462174508;4323.1785960668;4324.783760811947;9295.814083718287;9302.25581953442;9398;9406.38858474197;9420.434773913586;4607.9078418431445;4658.673892827537;4664.463586687574;4678.789454474557;4680.836170734008;3784.8864534064023;4055.148418832019;4211.115665710236;4236.555161708038;4248.447701798808;3663.6336366363685;3664.3770559005034;3781;3782.6406491383273;3794.715396345285;1174.2543484887158;1183.9704007399712;1204.9578264760692;1213.1204876464492;1231.1566576894857;678.725116327888;772.8802035684478;791.4934441957037;834.5910503853069;838.6058552480324;5086.5422112009355;5284.9471505284455;5290.947090529045;5386.784528618811;5405.729713514309;836.4312267658051;873.6330741088758;895.8253140637513;896.6323807239;903.5617725403174;3532.788032718045;3549.201429678353;3580.5703315601772;3582.4268117101137;3657.5976642569294;9115.179633832855;9422.057794220524;9513.667021654348;9515.666951656798;9540.045995400544;9819.459929703935;10018.599256029824;10037.247206459544;10066.194704423628;10100.949495252624;7550.811229719191;7584.962075189699;7648.502847314907;7650.273224043707;7673.884891726517;5024.4473107957365;5101.438841727481;5140.974295128501;5278.656887302313;5288.867778305573;9287.117723816227;9377.202937750368;9383.436993780395;9431.292653051185;9471.763205919908;9141.131592498701;9512.904870951203;9574.808503830023;9580.76048098803;9605.039496050618;5977.252843394575;6356.396142366468;6521.706523206372;6590.340965903371;6711.429528490133;7741.380689544935;7776.7278145264645;7807.063152421746;7808.609569521387;7866.370690344873;6684.465242780663;6729.865402692017;6790.7623233186605;6831.180258369028;7107.18267399235;6777.423918966943;6817.659117044227;6841;6916;7022.4382049436945;5708.714564271687;5709.400512946247;5756.769729210952;5814.912776308274;5837.5038121758425;4234.682398820039;4265.12564924196;4341.826326946887;4393.7363758174615;4428.446444194476;4334.0248444099825;4393.275109606879;4426.911461770811;4498.2577874650315;4499.865004049884 04:03:52 INFO - PROCESS | 11094 | |4;prototype.html;299.5177763800281;303.2570203002643;303.87541108145666;309.35962557505974;310.579165231112;5134.409542902563;5164.8120932185575;5166.276721259027;5172.224166375046;5188.6367954243215;5017.874553136165;5037.118504261758;5046.82336118236;5055.671381360209;5073.416557095935;3729.8135093245364;3839.8656047038357;3942;3983.7012224083164;3997.4203740457615;3972.801359932006;4003.199360127986;4004.2391945530403;4021.617946295097;4028.979855100735;4002.8198731057173;4009.619086186822;4011.538673052607;4013.6989725770536;4023.9738866588978;3809.942850857239;4014.4179094031347;4028.496437945242;4034;4040.6969477289026;3553.9644603553893;3567.4292113262013;3568.80371579563;3572.321258960815;3576.337003293455;5024.949750502521;5053.8736531587;5061.822836200715;5063.569596584295;5067.797288108472;4527.954720452786;4594.885127871797;4633.976830115862;4644.419447569054;4647.744374059425;5351.090314646481;5351.652142610717;5357.946420535784;5362.678239305654;5365.03429382711;3852.84414675599;3877.592852750449;3878.5927477614728;3880.47613572167;3884.611538846121;5466.234727138204;5596.692181929992;5620;5643.887122257573;5661.7735290588325;3985.143194213258;3989.960100399017;3993.7204395692024;4001.799910004488;4012.518497780227;4052.77709725962;4061.7156799023783;4065.6747460203114;4070.0842310479907;4087.05997620543;4571.702839315434;4593.6095431888;4597.103564804898;4598.839040633628;4625.098105869323;5204.5576126028955;5321.441248668912;5330.521307591988;5374.301340825746;5380.92381523689;1387.5074348606302;1398.1680899864564;1408.295852073963;1412.3150272118014;1414.3069895751007;885.5439448683933;898.8651702244715;926.5413620257881;932.4871320773548;933.5845548730886;4552.84065057728;4572.661956771575;4587.311903214544;4636.8145274188655;4647.604953578983;5353.357597088374;5399.78400863961;5423.3491980962535;5444.50999410055;5460.645058071213;4452.1763473757455;4595.471520775153;4596.7931443085145;4600.700954437951;4618.815247390066;2898.7680985521106;2903.970960290412;2905.680375158731;2916.314666053476;2930.853457327125;5024.648274620815;5037.319961805183;5069.453816585903;5079.72061536619;5098;5440.156775699773;5526.309211348582;5560;5572.665640061609;5576.581756368289;5043.293938848564;5097.974510127426;5101.489851014943;5132.127538318495;5135.204043373283;5419;5421.701806400686;5475.5072043516275;5478.342598888159;5502.889942201214;5083.8053057530715;5371.167469042305;5375.838724838261;5387.245785590099;5397.109476936262;5027.3464449621315;5050.696958182521;5092.032513822362;5095.490450954875;5096.770645321044;3955.268275369066;3956.40653901917;3971.4638523798917;3974.2647610192207;3974.880753577397;5286.950961831519;5393.51458368733;5418.674879507243;5438.2325744134105;5440.211169380338;5236.9738151309;5255.579553635624;5280.20796880471;5302.1781623848365;5315.767377701297;5073.974630126826;5240.868978275421;5279.287296214962;5324.227986941949;5325.733713314241;5187.818426355059;5199.870003249949;5200.349956255468;5208.401033881;5217.530422262014;5143.7428128594165;5152.3044389007;5280.339957505312;5324.201369794562;5415.945840541702;5270.235815806764;5276.498732620395;5281.234221038005;5281.867953301198;5322.494363035506 04:03:52 INFO - PROCESS | 11094 | |5;yui.html;665.7170702451458;699.8285420072086;739.8446326271483;746.2574738135556;757.1066141952497;12233.938830305848;12806.935965320185;12950;12963.351832408389;13035.674108147301;13027.28349940753;13191.2744799036;13283.667908302297;13335.599932002031;13420.194788312709;757.8219118507146;776.8873513340562;777.8366543025971;780.4887798491997;782.5930516131608;783.6591082878966;783.8667426537473;788.6254029336048;790.3084800799301;790.3519114326255;811.7808191788214;812.7358608452276;815.9102498725135;817.8446095241885;822.0710597025353;804.6700852650414;807.4993504027511;808.3331251717357;808.8139727862624;811.7808191788214;592.0763608770332;592.6266452135127;594.2809200866956;595.3064679648205;597.4801922327559;11891.464884080237;11928.642140735792;11931.224470409396;11980.161388702794;11988.820167697491;11078.446077696164;11161.107111431065;11326.377049262288;11481.024112950408;11664.883351166465;9777.804443911082;9800.803983920281;9812.803743925082;9951.353162044516;10104.494775261208;3280.4259254630583;3290.243244053881;3313.7680362374645;3401.183715908189;3413.5221069050353;42998.35502467434;52056.21915671268;53934.46065539333;54452.72773636146;57602.42397576055;9405.341626086109;9490.810183796286;9683.709488715349;9697.272704547187;9713.514324283757;18204.36284730028;18298;18447.90776046138;18533.443996680122;18997.240110395705;7157.749478768218;7173.497855150194;7243.818904527429;7262.419006479469;7328.413726901942;3884.7280690351968;3964.0684439156776;3977.244323578511;3999.6200360965663;4027.838886444568;2876.4390943765766;2965.7692057795775;2969.8218106913223;2978.836164010957;2991.641003079644;513.4531723714232;514.2902794144057;521.3795583255913;533.1576109746591;533.6131304803986;506.4226781469128;531.6305167908343;546.7219011237086;571.1404336473581;579.0503574138417;7461.607138403752;7787.610619469004;7926.088499822594;8037.23646253605;8399.454035487674;447.8560505253105;546.6610701365179;573.9770409183669;574.1932584718477;574.5776854012298;3866.3920158406336;3938.7439816411843;3965.484487016727;3998.660113890352;4024.3158663027357;77998;94445;95228;97925;100334;76124.23875761172;78742.60628696819;78925;80975.59512202519;81864.59067704623;45630.31554526685;53614.463855361726;67491;73865;76543.2345676536;8556.315494760529;8632.784180395289;8975.371723979259;9014.467540518259;9295.488748118918;43134.56865431306;43262.56737432711;43680.34479482747;43830.56169438393;43943;53095.46904530905;60842.391576083675;61306.69346653238;61461;61640.38359616346;12310.322932238454;12439.751204976032;12526.498940042296;12647.304398258184;12648.367581620698;12916.547920822726;12999.552528215658;13016.934915325362;13212.603621891358;13329.866701332863;12738.490460381481;12791.616251512469;12952.222866628032;13108.344582771015;13426.731465370833;11602.07183425307;11667.474963626488;11721.472533736172;11912.76174476523;11991.820122697993;12130;12144.271343719405;12204.328761917825;12248.203866748632;12716.745665086832;9888.208943284664;9919.355241909252;10024.799504010025;10048.69853904384;10264.538095785558;9980.550875210778;10261.179105671677;10283;10290.742731431774;10389.896101038892 04:03:52 INFO - PROCESS | 11094 | __end_tp_report 04:03:52 INFO - PROCESS | 11094 | __start_cc_report 04:03:52 INFO - PROCESS | 11094 | _x_x_mozilla_cycle_collect,404 04:03:52 INFO - PROCESS | 11094 | __end_cc_report 04:03:52 INFO - PROCESS | 11094 | __startTimestamp1467371032241__endTimestamp 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - PROCESS | 11094 | ------- Summary: start ------- 04:03:52 INFO - PROCESS | 11094 | Number of tests: 6 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - PROCESS | 11094 | [#0] dojo.html Cycles:165 Average:4805.80 Median:4944.95 stddev:537.63 (10.9%) stddev-sans-first:511.71 04:03:52 INFO - PROCESS | 11094 | Values: 2639.3 2666.9 2678.0 2678.8 2680.4 4722.3 4724.6 4785.2 4840.6 4879.0 4744.5 4872.6 4881.4 4903.5 5025.2 4420.9 4438.6 4484.4 4579.4 4602.8 4254.7 4529.9 4582.5 4635.4 4644.6 4350.3 4388.5 4415.0 4520.3 4521.4 4448.0 4456.4 4460.5 4468.4 4486.7 4414.5 4435.8 4451.7 4458.8 4461.0 4796.6 4817.1 4836.8 4838.1 4864.8 5190.5 5207.7 5214.2 5224.7 5265.0 5104.9 5200.3 5222.6 5244.1 5261.6 4842.7 4877.4 4885.8 4905.9 4920.7 5361.4 5376.5 5392.1 5407.4 5457.7 5015.4 5095.7 5143.9 5144.2 5156.4 5099.4 5213.8 5244.6 5258.2 5303.4 5061.8 5160.9 5175.5 5176.0 5190.6 5124.3 5132.5 5136.7 5155.1 5173.8 4059.1 4112.0 4118.5 4123.9 4125.1 3658.8 3676.7 3698.2 3702.6 3705.5 4440.1 4444.3 4501.4 4511.1 4597.8 5246.4 5283.8 5292.0 5305.5 5311.4 4538.6 4544.6 4549.9 4578.3 4586.3 4602.2 4644.2 4688.0 4710.0 4710.6 4861.7 4885.7 4896.2 4899.3 4948.1 5128.2 5255.7 5281.0 5301.7 5306.5 4872.7 4882.5 4921.6 4945.0 4953.8 5184.0 5195.7 5200.6 5209.9 5242.4 5158.4 5220.5 5273.2 5278.0 5289.9 5046.5 5071.1 5132.5 5135.3 5153.9 5058.4 5109.8 5113.3 5124.5 5136.1 4853.5 4956.0 5042.0 5058.1 5064.0 5011.2 5076.6 5090.0 5094.9 5127.4 5029.1 5050.5 5072.8 5081.9 5097.2 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - PROCESS | 11094 | [#1] ext.html Cycles:180 Average:48483.05 Median:37095.04 stddev:93028.40 (250.8%) stddev-sans-first:93219.74 04:03:52 INFO - PROCESS | 11094 | Values: 542.5 570.2 573.3 577.2 587.7 29302.7 40412.4 41354.6 41559.2 41755.2 37851.6 38288.6 38431.8 38446.0 38468.0 7777.2 7918.8 7941.3 7941.9 7958.7 7770.3 7827.6 7852.6 7893.4 7896.8 7905.0 7906.7 7913.8 7918.3 7922.6 7862.6 7874.3 7897.6 7926.9 7936.2 7874.3 7918.6 7934.4 7935.4 7952.4 39450.2 39577.8 39626.8 39758.0 39810.6 3100.6 3219.1 3229.8 3238.5 3566.0 29153.6 29162.7 29358.3 30195.4 30298.0 3374.2 3421.4 3444.3 3493.3 3496.8 241786.0 242298.0 242892.0 243128.0 244668.8 29748.0 54586.7 54930.7 55051.0 55186.4 31189.7 32822.0 32866.7 32968.7 33013.0 12231.2 12232.3 12274.1 12298.8 12320.7 10710.0 10727.7 10744.0 10767.5 10789.0 7874.4 7969.4 7985.0 8052.2 8081.5 3120.7 3140.8 3141.7 3187.8 3218.2 936.8 953.2 955.2 973.9 984.2 28429.7 28556.6 28576.7 29070.0 29537.0 943.6 946.0 976.3 1007.1 1028.9 14947.8 15206.0 15225.8 15385.0 15439.9 421402.0 424285.0 425025.0 425624.0 426649.0 49910.8 50106.5 50148.0 50459.5 50587.2 1165.3 1170.9 1205.9 1208.3 1213.7 26361.5 27809.3 27976.0 28146.3 28267.4 42154.4 42370.0 42571.1 42741.0 42909.0 359867.0 360013.0 360957.0 363130.0 364495.0 25496.2 25842.1 26045.0 26198.7 26779.0 41747.8 42300.6 42458.4 42519.4 42812.8 36516.5 37102.3 37138.8 37196.8 37312.6 36564.3 37158.3 37677.6 37789.1 38139.8 35675.8 36343.8 36476.6 36881.0 37087.8 32233.8 32614.3 33569.8 33593.7 33710.8 25441.5 25900.0 25940.0 26061.6 26456.0 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - PROCESS | 11094 | [#2] jquery.html Cycles:180 Average:25354.22 Median:4797.44 stddev:68788.54 (1433.9%) stddev-sans-first:68955.93 04:03:52 INFO - PROCESS | 11094 | Values: 369.2 371.3 372.4 377.3 383.1 16234.2 16958.4 17593.6 17598.8 17642.6 16235.6 16778.2 17962.5 18013.5 18026.4 4624.5 4818.3 4850.9 4853.4 4858.1 3555.8 4776.6 5261.3 5547.0 5554.1 5549.7 5551.4 5569.7 5614.7 5632.2 5509.2 5590.1 5594.0 5605.6 5609.7 5273.4 5412.6 5418.8 5425.0 5425.8 21080.7 21816.0 21848.1 22045.6 22119.7 1746.2 1913.3 2042.8 2166.0 2327.5 9133.1 9369.2 9418.5 9549.1 9595.0 1690.4 1700.0 1759.4 1809.9 1822.6 67008.0 67017.7 68183.3 68209.3 68746.0 9874.8 10148.4 10245.9 10270.4 10532.9 14151.2 14153.0 14211.5 14226.3 14272.3 6804.0 6932.2 7008.6 7047.5 7054.6 6347.8 6410.8 6413.4 6535.4 6593.1 4325.6 4392.9 4406.8 4452.9 4494.7 1681.9 1717.9 1839.8 1867.4 1875.6 860.0 864.7 881.5 921.9 927.1 17030.7 17038.6 18041.8 18678.4 18928.3 855.2 861.3 884.9 935.6 954.5 9855.0 10204.2 10239.9 10270.7 10310.4 408396.0 409800.0 415638.0 423979.0 426470.0 53495.0 76477.2 84474.6 84896.0 89022.6 911.4 919.8 925.9 954.8 961.4 13066.9 15483.1 16411.0 16483.3 17003.7 37659.8 39562.0 39746.4 40952.4 41681.0 56727.4 56782.4 57275.4 57451.0 58079.4 7754.8 7761.9 7779.4 7788.5 7828.1 8183.0 11158.7 11209.6 11765.5 11930.0 9525.8 9754.7 9760.5 9888.4 10023.7 9741.8 10239.2 10297.4 10432.3 10645.4 9993.4 10235.7 10363.6 10431.4 10504.0 6549.3 6948.4 7843.1 7848.1 7856.1 8998.6 9911.7 9977.6 10132.5 10659.8 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - PROCESS | 11094 | [#3] mootools.html Cycles:180 Average:5202.69 Median:5093.99 stddev:2972.40 (58.4%) stddev-sans-first:2966.77 04:03:52 INFO - PROCESS | 11094 | Values: 1368.5 1405.4 1478.8 1688.8 1706.4 7040.5 7665.5 7679.9 8174.2 8187.8 7779.1 7975.4 8018.3 8052.6 8057.1 2215.4 2243.7 2246.7 2246.9 2247.0 2159.1 2204.3 2205.5 2205.7 2215.2 2216.1 2222.4 2230.1 2233.0 2243.9 2156.1 2187.2 2189.9 2192.7 2196.9 2143.6 2155.9 2160.8 2168.0 2169.2 7990.8 8077.0 8090.2 8116.2 8145.0 4393.1 4508.9 4516.0 4518.5 4521.3 2954.6 2965.7 2973.4 2994.8 3076.5 932.7 957.4 958.7 972.6 984.5 11066.9 11092.3 11096.0 11112.6 11117.7 4032.7 4236.2 4300.2 4323.2 4324.8 9295.8 9302.3 9398.0 9406.4 9420.4 4607.9 4658.7 4664.5 4678.8 4680.8 3784.9 4055.1 4211.1 4236.6 4248.4 3663.6 3664.4 3781.0 3782.6 3794.7 1174.3 1184.0 1205.0 1213.1 1231.2 678.7 772.9 791.5 834.6 838.6 5086.5 5284.9 5290.9 5386.8 5405.7 836.4 873.6 895.8 896.6 903.6 3532.8 3549.2 3580.6 3582.4 3657.6 9115.2 9422.1 9513.7 9515.7 9540.0 9819.5 10018.6 10037.2 10066.2 10100.9 7550.8 7585.0 7648.5 7650.3 7673.9 5024.4 5101.4 5141.0 5278.7 5288.9 9287.1 9377.2 9383.4 9431.3 9471.8 9141.1 9512.9 9574.8 9580.8 9605.0 5977.3 6356.4 6521.7 6590.3 6711.4 7741.4 7776.7 7807.1 7808.6 7866.4 6684.5 6729.9 6790.8 6831.2 7107.2 6777.4 6817.7 6841.0 6916.0 7022.4 5708.7 5709.4 5756.8 5814.9 5837.5 4234.7 4265.1 4341.8 4393.7 4428.4 4334.0 4393.3 4426.9 4498.3 4499.9 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - PROCESS | 11094 | [#4] prototype.html Cycles:180 Average:4430.00 Median:5058.75 stddev:1266.60 (25.0%) stddev-sans-first:1231.63 04:03:52 INFO - PROCESS | 11094 | Values: 299.5 303.3 303.9 309.4 310.6 5134.4 5164.8 5166.3 5172.2 5188.6 5017.9 5037.1 5046.8 5055.7 5073.4 3729.8 3839.9 3942.0 3983.7 3997.4 3972.8 4003.2 4004.2 4021.6 4029.0 4002.8 4009.6 4011.5 4013.7 4024.0 3809.9 4014.4 4028.5 4034.0 4040.7 3554.0 3567.4 3568.8 3572.3 3576.3 5024.9 5053.9 5061.8 5063.6 5067.8 4528.0 4594.9 4634.0 4644.4 4647.7 5351.1 5351.7 5357.9 5362.7 5365.0 3852.8 3877.6 3878.6 3880.5 3884.6 5466.2 5596.7 5620.0 5643.9 5661.8 3985.1 3990.0 3993.7 4001.8 4012.5 4052.8 4061.7 4065.7 4070.1 4087.1 4571.7 4593.6 4597.1 4598.8 4625.1 5204.6 5321.4 5330.5 5374.3 5380.9 1387.5 1398.2 1408.3 1412.3 1414.3 885.5 898.9 926.5 932.5 933.6 4552.8 4572.7 4587.3 4636.8 4647.6 5353.4 5399.8 5423.3 5444.5 5460.6 4452.2 4595.5 4596.8 4600.7 4618.8 2898.8 2904.0 2905.7 2916.3 2930.9 5024.6 5037.3 5069.5 5079.7 5098.0 5440.2 5526.3 5560.0 5572.7 5576.6 5043.3 5098.0 5101.5 5132.1 5135.2 5419.0 5421.7 5475.5 5478.3 5502.9 5083.8 5371.2 5375.8 5387.2 5397.1 5027.3 5050.7 5092.0 5095.5 5096.8 3955.3 3956.4 3971.5 3974.3 3974.9 5287.0 5393.5 5418.7 5438.2 5440.2 5237.0 5255.6 5280.2 5302.2 5315.8 5074.0 5240.9 5279.3 5324.2 5325.7 5187.8 5199.9 5200.3 5208.4 5217.5 5143.7 5152.3 5280.3 5324.2 5415.9 5270.2 5276.5 5281.2 5281.9 5322.5 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - PROCESS | 11094 | [#5] yui.html Cycles:180 Average:16834.81 Median:26288.80 stddev:23404.59 (89.0%) stddev-sans-first:23438.75 04:03:52 INFO - PROCESS | 11094 | Values: 665.7 699.8 739.8 746.3 757.1 12233.9 12806.9 12950.0 12963.4 13035.7 13027.3 13191.3 13283.7 13335.6 13420.2 757.8 776.9 777.8 780.5 782.6 783.7 783.9 788.6 790.3 790.4 811.8 812.7 815.9 817.8 822.1 804.7 807.5 808.3 808.8 811.8 592.1 592.6 594.3 595.3 597.5 11891.5 11928.6 11931.2 11980.2 11988.8 11078.4 11161.1 11326.4 11481.0 11664.9 9777.8 9800.8 9812.8 9951.4 10104.5 3280.4 3290.2 3313.8 3401.2 3413.5 42998.4 52056.2 53934.5 54452.7 57602.4 9405.3 9490.8 9683.7 9697.3 9713.5 18204.4 18298.0 18447.9 18533.4 18997.2 7157.7 7173.5 7243.8 7262.4 7328.4 3884.7 3964.1 3977.2 3999.6 4027.8 2876.4 2965.8 2969.8 2978.8 2991.6 513.5 514.3 521.4 533.2 533.6 506.4 531.6 546.7 571.1 579.1 7461.6 7787.6 7926.1 8037.2 8399.5 447.9 546.7 574.0 574.2 574.6 3866.4 3938.7 3965.5 3998.7 4024.3 77998.0 94445.0 95228.0 97925.0 100334.0 76124.2 78742.6 78925.0 80975.6 81864.6 45630.3 53614.5 67491.0 73865.0 76543.2 8556.3 8632.8 8975.4 9014.5 9295.5 43134.6 43262.6 43680.3 43830.6 43943.0 53095.5 60842.4 61306.7 61461.0 61640.4 12310.3 12439.8 12526.5 12647.3 12648.4 12916.5 12999.6 13016.9 13212.6 13329.9 12738.5 12791.6 12952.2 13108.3 13426.7 11602.1 11667.5 11721.5 11912.8 11991.8 12130.0 12144.3 12204.3 12248.2 12716.7 9888.2 9919.4 10024.8 10048.7 10264.5 9980.6 10261.2 10283.0 10290.7 10389.9 04:03:52 INFO - PROCESS | 11094 | -------- Summary: end -------- 04:03:52 INFO - PROCESS | 11094 | 04:03:52 INFO - TEST-INFO | 11094: exit 0 04:03:53 INFO - TEST-OK | dromaeo_css | took 1115598ms 04:03:53 INFO - TEST-START | kraken 04:03:53 INFO - operating with platform_type : linux_ 04:03:53 INFO - Initialising browser for kraken test... 04:03:53 INFO - TEST-INFO | started process 11339 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpa27LYA/profile http://localhost:50467/getInfo.html) 04:03:57 INFO - PROCESS | 11339 | __metrics Screen width/height:1600/1200 04:03:57 INFO - PROCESS | 11339 | colorDepth:24 04:03:57 INFO - PROCESS | 11339 | Browser inner width/height: 1024/697 04:03:57 INFO - PROCESS | 11339 | __metrics 04:03:58 ERROR - PROCESS | 11339 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 04:03:59 INFO - TEST-INFO | 11339: exit 0 04:03:59 INFO - Browser initialized. 04:03:59 INFO - Running cycle 1/1 for kraken test... 04:03:59 INFO - TEST-INFO | started process 11460 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpa27LYA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:04:11 INFO - PROCESS | 11460 | RSS: Main: 169594880 04:04:11 INFO - PROCESS | 11460 | 04:04:13 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50467/tests/kraken/driver.html?testName=audio-beat-detection) 04:04:14 INFO - PROCESS | 11460 | RSS: Main: 174927872 04:04:14 INFO - PROCESS | 11460 | 04:04:17 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50467/tests/kraken/driver.html?testName=audio-dft) 04:04:18 INFO - PROCESS | 11460 | RSS: Main: 174198784 04:04:18 INFO - PROCESS | 11460 | 04:04:21 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50467/tests/kraken/driver.html?testName=audio-fft) 04:04:21 INFO - PROCESS | 11460 | RSS: Main: 169025536 04:04:21 INFO - PROCESS | 11460 | 04:04:24 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50467/tests/kraken/driver.html?testName=audio-oscillator) 04:04:24 INFO - PROCESS | 11460 | RSS: Main: 169639936 04:04:24 INFO - PROCESS | 11460 | 04:04:26 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50467/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:04:27 INFO - PROCESS | 11460 | RSS: Main: 170397696 04:04:27 INFO - PROCESS | 11460 | 04:04:30 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50467/tests/kraken/driver.html?testName=imaging-darkroom) 04:04:31 INFO - PROCESS | 11460 | RSS: Main: 170995712 04:04:31 INFO - PROCESS | 11460 | 04:04:34 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50467/tests/kraken/driver.html?testName=imaging-desaturate) 04:04:35 INFO - PROCESS | 11460 | RSS: Main: 167849984 04:04:35 INFO - PROCESS | 11460 | 04:04:38 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50467/tests/kraken/driver.html?testName=json-parse-financial) 04:04:39 INFO - PROCESS | 11460 | RSS: Main: 169148416 04:04:39 INFO - PROCESS | 11460 | 04:04:40 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50467/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:04:41 INFO - PROCESS | 11460 | RSS: Main: 169684992 04:04:41 INFO - PROCESS | 11460 | 04:04:43 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50467/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:04:44 INFO - PROCESS | 11460 | RSS: Main: 169910272 04:04:44 INFO - PROCESS | 11460 | 04:04:46 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50467/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:04:46 INFO - PROCESS | 11460 | RSS: Main: 170405888 04:04:46 INFO - PROCESS | 11460 | 04:04:49 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50467/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:04:50 INFO - PROCESS | 11460 | RSS: Main: 170233856 04:04:50 INFO - PROCESS | 11460 | 04:04:53 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50467/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:04:53 INFO - PROCESS | 11460 | RSS: Main: 169725952 04:04:53 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | Cycle 1(1): loaded http://localhost:50467/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50467/tests/kraken/driver.html?testName=ai-astar) 04:04:55 INFO - PROCESS | 11460 | RSS: Main: 170741760 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | __start_tp_report 04:04:55 INFO - PROCESS | 11460 | _x_x_mozilla_page_load 04:04:55 INFO - PROCESS | 11460 | _x_x_mozilla_page_load_details 04:04:55 INFO - PROCESS | 11460 | |i|pagename|runs| 04:04:55 INFO - PROCESS | 11460 | |0;ai-astar;105;114;108;114;115;116;115;116;114;115 04:04:55 INFO - PROCESS | 11460 | |1;audio-beat-detection;152;123;146;171;123;154;147;123;185;122 04:04:55 INFO - PROCESS | 11460 | |2;audio-dft;164;163;163;168;167;164;164;164;164;163 04:04:55 INFO - PROCESS | 11460 | |3;audio-fft;77;76;77;156;77;77;78;83;174;77 04:04:55 INFO - PROCESS | 11460 | |4;audio-oscillator;84;86;147;85;86;85;136;85;86;136 04:04:55 INFO - PROCESS | 11460 | |5;imaging-gaussian-blur;118;118;118;117;117;118;118;118;119;118 04:04:55 INFO - PROCESS | 11460 | |6;imaging-darkroom;149;148;151;148;149;149;150;147;148;148 04:04:55 INFO - PROCESS | 11460 | |7;imaging-desaturate;95;95;95;100;95;97;95;99;99;96 04:04:55 INFO - PROCESS | 11460 | |8;json-parse-financial;64;65;66;65;66;67;64;65;64;65 04:04:55 INFO - PROCESS | 11460 | |9;json-stringify-tinderbox;66;66;67;65;64;65;66;66;65;65 04:04:55 INFO - PROCESS | 11460 | |10;stanford-crypto-aes;79;78;79;78;78;79;79;80;83;88 04:04:55 INFO - PROCESS | 11460 | |11;stanford-crypto-ccm;132;126;132;136;140;128;134;131;163;130 04:04:55 INFO - PROCESS | 11460 | |12;stanford-crypto-pbkdf2;171;167;167;166;169;166;166;170;164;167 04:04:55 INFO - PROCESS | 11460 | |13;stanford-crypto-sha256-iterative;70;71;66;67;66;68;68;69;66;68 04:04:55 INFO - PROCESS | 11460 | __end_tp_report 04:04:55 INFO - PROCESS | 11460 | __start_cc_report 04:04:55 INFO - PROCESS | 11460 | _x_x_mozilla_cycle_collect,1041 04:04:55 INFO - PROCESS | 11460 | __end_cc_report 04:04:55 INFO - PROCESS | 11460 | __startTimestamp1467371095800__endTimestamp 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | ------- Summary: start ------- 04:04:55 INFO - PROCESS | 11460 | Number of tests: 14 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#0] ai-astar Cycles:10 Average:113.20 Median:115.00 stddev:3.68 (3.2%) stddev-sans-first:2.42 04:04:55 INFO - PROCESS | 11460 | Values: 105.0 114.0 108.0 114.0 115.0 116.0 115.0 116.0 114.0 115.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#1] audio-beat-detection Cycles:10 Average:144.60 Median:149.50 stddev:22.09 (14.8%) stddev-sans-first:23.26 04:04:55 INFO - PROCESS | 11460 | Values: 152.0 123.0 146.0 171.0 123.0 154.0 147.0 123.0 185.0 122.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#2] audio-dft Cycles:10 Average:164.40 Median:164.00 stddev:1.71 (1.0%) stddev-sans-first:1.81 04:04:55 INFO - PROCESS | 11460 | Values: 164.0 163.0 163.0 168.0 167.0 164.0 164.0 164.0 164.0 163.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#3] audio-fft Cycles:10 Average:95.20 Median:77.00 stddev:37.08 (48.2%) stddev-sans-first:38.74 04:04:55 INFO - PROCESS | 11460 | Values: 77.0 76.0 77.0 156.0 77.0 77.0 78.0 83.0 174.0 77.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#4] audio-oscillator Cycles:10 Average:101.60 Median:85.00 stddev:26.45 (31.1%) stddev-sans-first:27.27 04:04:55 INFO - PROCESS | 11460 | Values: 84.0 86.0 147.0 85.0 86.0 85.0 136.0 85.0 86.0 136.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#5] imaging-gaussian-blur Cycles:10 Average:117.90 Median:118.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 04:04:55 INFO - PROCESS | 11460 | Values: 118.0 118.0 118.0 117.0 117.0 118.0 118.0 118.0 119.0 118.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#6] imaging-darkroom Cycles:10 Average:148.70 Median:149.00 stddev:1.16 (0.8%) stddev-sans-first:1.22 04:04:55 INFO - PROCESS | 11460 | Values: 149.0 148.0 151.0 148.0 149.0 149.0 150.0 147.0 148.0 148.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#7] imaging-desaturate Cycles:10 Average:96.60 Median:95.50 stddev:2.01 (2.1%) stddev-sans-first:2.05 04:04:55 INFO - PROCESS | 11460 | Values: 95.0 95.0 95.0 100.0 95.0 97.0 95.0 99.0 99.0 96.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#8] json-parse-financial Cycles:10 Average:65.10 Median:65.00 stddev:0.99 (1.5%) stddev-sans-first:0.97 04:04:55 INFO - PROCESS | 11460 | Values: 64.0 65.0 66.0 65.0 66.0 67.0 64.0 65.0 64.0 65.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#9] json-stringify-tinderbox Cycles:10 Average:65.50 Median:66.00 stddev:0.85 (1.3%) stddev-sans-first:0.88 04:04:55 INFO - PROCESS | 11460 | Values: 66.0 66.0 67.0 65.0 64.0 65.0 66.0 66.0 65.0 65.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#10] stanford-crypto-aes Cycles:10 Average:80.10 Median:79.00 stddev:3.14 (4.0%) stddev-sans-first:3.31 04:04:55 INFO - PROCESS | 11460 | Values: 79.0 78.0 79.0 78.0 78.0 79.0 79.0 80.0 83.0 88.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#11] stanford-crypto-ccm Cycles:10 Average:135.20 Median:133.00 stddev:10.54 (7.9%) stddev-sans-first:11.11 04:04:55 INFO - PROCESS | 11460 | Values: 132.0 126.0 132.0 136.0 140.0 128.0 134.0 131.0 163.0 130.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.30 Median:167.00 stddev:2.11 (1.3%) stddev-sans-first:1.76 04:04:55 INFO - PROCESS | 11460 | Values: 171.0 167.0 167.0 166.0 169.0 166.0 166.0 170.0 164.0 167.0 04:04:55 INFO - PROCESS | 11460 | 04:04:55 INFO - PROCESS | 11460 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.90 Median:68.00 stddev:1.73 (2.5%) stddev-sans-first:1.66 04:04:55 INFO - PROCESS | 11460 | Values: 70.0 71.0 66.0 67.0 66.0 68.0 68.0 69.0 66.0 68.0 04:04:55 INFO - PROCESS | 11460 | -------- Summary: end -------- 04:04:55 INFO - PROCESS | 11460 | 04:04:56 INFO - TEST-INFO | 11460: exit 0 04:04:56 INFO - TEST-OK | kraken | took 63836ms 04:04:56 INFO - SUITE-END | took 1179s 04:04:56 INFO - Completed test suite (00:19:39) 04:04:56 INFO - javascript benchmark 04:04:57 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6448.885363501047, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2639.326971622236, 2666.9333266668336, 2678.049292501162, 2678.812483126182, 2680.3969106950926, 4722.315264286676, 4724.598409135223, 4785.210440277355, 4840.56434920857, 4878.975605121969, 4744.478107408182, 4872.585830204437, 4881.41423029237, 4903.485134060926, 5025.195968645017, 4420.9115817683705, 4438.644908407319, 4484.439445069366, 4579.427571553556, 4602.769861506911, 4254.744715317091, 4529.909401811962, 4582.495925448198, 4635.443746750378, 4644.60520855726, 4350.32569951658, 4388.451443569554, 4414.955850441486, 4520.276755719102, 4521.389612402317, 4448.021435284265, 4456.3538286948215, 4460.50934397216, 4468.352088947117, 4486.730796152241, 4414.536473670282, 4435.844745433927, 4451.732896026248, 4458.754768487732, 4461.018575913294, 4796.5683088521855, 4817.084753896748, 4836.758162091881, 4838.104950584118, 4864.8297309594345, 5190.506901844319, 5207.739613019334, 5214.243934629458, 5224.660397074178, 5265.0, 5104.897902041976, 5200.271961925334, 5222.608304377149, 5244.082285600005, 5261.579073674096, 4842.709437433765, 4877.3903262092235, 4885.780139893714, 4905.852824415273, 4920.6555541111775, 5361.356637203483, 5376.542993845567, 5392.083345831218, 5407.432219616962, 5457.672539647634, 5015.448300686921, 5095.719735414587, 5143.871403214875, 5144.202648589475, 5156.381234251914, 5099.388073431212, 5213.817516386908, 5244.606654500928, 5258.2375555544995, 5303.390110137307, 5061.848144555669, 5160.92258616121, 5175.534201921845, 5175.9741201293755, 5190.558802501754, 5124.333836601218, 5132.538071573576, 5136.691798492103, 5155.072087024371, 5173.793048278027, 4059.127287633173, 4112.033672087057, 4118.5263694674895, 4123.876283711494, 4125.092479654471, 3658.835352409148, 3676.7426280160666, 3698.2418604186078, 3702.55600315877, 3705.5182826232417, 4440.089781594766, 4444.28891377378, 4501.392312037833, 4511.142882852313, 4597.793099310539, 5246.370435547682, 5283.815066472655, 5292.047431462373, 5305.469453054664, 5311.415744268127, 4538.614217791459, 4544.613707834871, 4549.909001820011, 4578.313253012075, 4586.2661974083985, 4602.171609110325, 4644.233701439225, 4688.0, 4709.987352719113, 4710.646701497401, 4861.708297502161, 4885.65800393969, 4896.2166053430565, 4899.289603007615, 4948.05986862495, 5128.153854613947, 5255.737213139251, 5281.0, 5301.727585379558, 5306.469353064663, 4872.707637541759, 4882.511748825089, 4921.6062714982, 4944.950550494449, 4953.7523123844385, 5184.0, 5195.7142357170715, 5200.60995425337, 5209.869753256199, 5242.449542797951, 5158.3552055993005, 5220.504052115043, 5273.156294992783, 5277.997180535686, 5289.9471005291, 5046.520580544842, 5071.0872043032605, 5132.486751324837, 5135.2553879687985, 5153.948460515347, 5058.443571207238, 5109.846704598868, 5113.284140220447, 5124.5131712487255, 5136.101182293009, 4853.49038350968, 4955.975220123876, 5041.974790126026, 5058.089543882136, 5064.037832811754, 5011.223260394645, 5076.619253556072, 5090.0, 5094.898102037864, 5127.359080114986, 5029.145045342374, 5050.545450909436, 5072.847814565569, 5081.923771143362, 5097.158968770112], "value": 4769.217788529098, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [542.5361316074756, 570.178942323055, 573.286258608033, 577.1948132355365, 587.74726867447, 29302.706972930264, 40412.39381409278, 41354.58645413545, 41559.16881662365, 41755.164896702125, 37851.62148378515, 38288.617113828856, 38431.80784096083, 38446.0, 38468.0, 7777.183395743436, 7918.762437126896, 7941.28528432441, 7941.920580794204, 7958.721444749435, 7770.300672939435, 7827.569483678395, 7852.607369631524, 7893.368530517573, 7896.802579935519, 7904.960475197616, 7906.723264685737, 7913.802154946144, 7918.32694220989, 7922.643481043338, 7862.567558784264, 7874.2913137817295, 7897.644605992744, 7926.8810967835525, 7936.166702496242, 7874.330681892046, 7918.6436610352675, 7934.365250779923, 7935.444518883681, 7952.403569732235, 39450.21099578021, 39577.80211098926, 39626.801865990485, 39758.0, 39810.60189398127, 3100.6441023600464, 3219.114743445571, 3229.83850807461, 3238.5142228665654, 3565.982170089159, 29153.56269655957, 29162.70837291621, 29358.266043348875, 30195.396092078256, 30298.0, 3374.223928496435, 3421.4354631485776, 3444.2594842109065, 3493.266414053052, 3496.8251587420527, 241786.0, 242298.0, 242892.0, 243128.0, 244668.77665611735, 29748.0, 54586.727066364416, 54930.725346373016, 55051.0, 55186.448135518134, 31189.688103119133, 32822.0, 32866.67133328684, 32968.67031329704, 33013.0, 12231.204971676812, 12232.266064036186, 12274.079444041732, 12298.754024919452, 12320.691982700504, 10710.03609675133, 10727.678169654922, 10744.033037026706, 10767.515461804238, 10789.028987391173, 7874.409419293576, 7969.402294827911, 7984.960075199587, 8052.194780522018, 8081.515109093473, 3120.7347375472887, 3140.775097711894, 3141.68583141684, 3187.792793468417, 3218.1954511372155, 936.7751739582451, 953.1755031897359, 955.1833182628891, 973.9415635061919, 984.2322988069318, 28429.71570284312, 28556.571651425245, 28576.714232857823, 29070.0, 29536.977172129365, 943.5942544705842, 945.9621615135318, 976.2677991506371, 1007.1489591295343, 1028.8713910761155, 14947.775783363259, 15206.0, 15225.847741522664, 15385.0, 15439.922800385926, 421402.0, 424285.0, 425025.0, 425624.0, 426649.0, 49910.752231194514, 50106.49893501091, 50148.0, 50459.49540504621, 50587.241191382156, 1165.2891736041008, 1170.8653504847052, 1205.8613259475096, 1208.323338930202, 1213.6844420450745, 26361.472770544864, 27809.304767380978, 27976.0, 28146.2963425916, 28267.43465130727, 42154.36768448415, 42370.0, 42571.14857702766, 42741.0, 42909.0, 359867.0, 360013.0, 360957.0, 363130.0, 364495.0, 25496.23511294664, 25842.095526656478, 26045.0, 26198.73801261963, 26779.0, 41747.7912610435, 42300.57699422966, 42458.36312455254, 42519.3622095675, 42812.78593607012, 36516.452253216754, 37102.25795484129, 37138.814305928296, 37196.81401593083, 37312.626873730915, 36564.268714625025, 37158.25683486369, 37677.62322376741, 37789.05527361728, 38139.80930095332, 35675.82162089173, 36343.818280908425, 36476.63523364732, 36881.0, 37087.81456092702, 32233.838830805696, 32614.34771304608, 33569.83215083909, 33593.66406335905, 33710.83144584359, 25441.491170176123, 25900.0, 25940.0, 26061.609075864257, 26456.0], "value": 16675.56429432791, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [369.1693689199301, 371.3167771300806, 372.3558244237469, 377.33588883564937, 383.1379396358194, 16234.188290585467, 16958.40645577405, 17593.56016099598, 17598.82401175988, 17642.558936026606, 16235.594110147253, 16778.244978975945, 17962.461126166203, 18013.549661258443, 18026.369077082305, 4624.537546245366, 4818.25317075852, 4850.927236091461, 4853.441854186761, 4858.149823780842, 3555.839987200582, 4776.617870570346, 5261.316028916235, 5546.972265138668, 5554.1391084381785, 5549.722513874311, 5551.3893471718075, 5569.66582005079, 5614.6631202128, 5632.239647647577, 5509.173623956399, 5590.077637189859, 5594.0, 5605.607607467479, 5609.719514024282, 5273.446288139767, 5412.648177868426, 5418.783248670048, 5424.972875135599, 5425.810096646638, 21080.683789743165, 21816.0, 21848.12607495698, 22045.559088818296, 22119.668204976937, 1746.1724656592787, 1913.2538310059088, 2042.7650820155723, 2165.9783402165936, 2327.487952650414, 9133.086691330815, 9369.156775890135, 9418.529073546295, 9549.140577348002, 9595.04049595042, 1690.4421540891476, 1700.0, 1759.384215524569, 1809.8959634623002, 1822.571695651521, 67008.0, 67017.66491167562, 68183.31816681869, 68209.31790682129, 68746.0, 9874.802503950024, 10148.441835698959, 10245.897541024644, 10270.383776973405, 10532.894671053346, 14151.221682807545, 14153.0, 14211.50259740904, 14226.28868556568, 14272.286385680674, 6803.965980170166, 6932.202796678446, 7008.614526201006, 7047.471439641945, 7054.6472676367, 6347.809565713036, 6410.839729006812, 6413.358664133642, 6535.444487218545, 6593.142891424084, 4325.6106950374615, 4392.9121417572105, 4406.801693923781, 4452.933206001912, 4494.73031618104, 1681.8990860548406, 1717.9226934787964, 1839.814422189503, 1867.3837633580886, 1875.5873707784265, 860.0, 864.740577826662, 881.532787622561, 921.9216366608913, 927.1284992107533, 17030.74453883193, 17038.57403564921, 18041.819581804277, 18678.439646810617, 18928.33750818715, 855.2003876375485, 861.2765277167209, 884.9247813935759, 935.6351023100996, 954.4680787336364, 9855.0, 10204.183665306758, 10239.897601024044, 10270.743231419125, 10310.43292618913, 408396.0, 409800.0, 415638.0, 423979.0, 426470.0, 53495.0, 76477.235227647, 84474.57762711147, 84896.0, 89022.55488722515, 911.4303560274828, 919.8475567172715, 925.9351845370759, 954.7613096725819, 961.3895176562793, 13066.934665326613, 15483.148426836633, 16411.0, 16483.34066637321, 17003.659926801643, 37659.81170094132, 39562.0, 39746.40380394354, 40952.38571421371, 41681.0, 56727.43272567387, 56782.43217567771, 57275.42724572701, 57451.0, 58079.419205807404, 7754.844903102019, 7761.92238077612, 7779.377649788116, 7788.493747906368, 7828.138904720362, 8182.959085204536, 11158.665240042812, 11209.607663731731, 11765.47055382527, 11930.045596352098, 9525.761855953378, 9754.658586949423, 9760.511974401394, 9888.406695598287, 10023.69928902134, 9741.756456088655, 10239.232057595562, 10297.3821570706, 10432.321899076536, 10645.414502202453, 9993.400395976265, 10235.692929212135, 10363.637272695722, 10431.426271555138, 10504.0, 6549.31232220629, 6948.374646281859, 7843.058832940083, 7848.097468790934, 7856.057273127261, 8998.55007249648, 9911.702648920544, 9977.62196031616, 10132.544035518273, 10659.840102398626], "value": 8293.246948896774, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1368.5073373585508, 1405.381632081884, 1478.8373278939314, 1688.7804585403896, 1706.4198172621313, 7040.542364746288, 7665.501742386741, 7679.884801727979, 8174.2234487723645, 8187.754367368981, 7779.144294127642, 7975.361971042317, 8018.318442932343, 8052.63763130659, 8057.073436554798, 2215.4461384653796, 2243.730752309725, 2246.7191601049867, 2246.932592022242, 2246.9887650561723, 2159.136345461812, 2204.2946257197705, 2205.5037616536233, 2205.7022301989186, 2215.1582398688474, 2216.0803266644402, 2222.4443889027743, 2230.1413955627118, 2232.9776702232934, 2243.887805609721, 2156.1267686586957, 2187.1688758271835, 2189.868607883532, 2192.6710993351044, 2196.9450763730874, 2143.582001509706, 2155.859869108503, 2160.83793715472, 2167.981048907011, 2169.175713228963, 7990.760277191694, 8076.959615201945, 8090.231428014329, 8116.228958248957, 8144.959275203586, 4393.055493068973, 4508.909821803545, 4515.954840451619, 4518.5481451854885, 4521.253993091136, 2954.5715871198554, 2965.6589492208454, 2973.43504734102, 2994.7604191664614, 3076.4616192166504, 932.7108596335158, 957.3585697582637, 958.7315551645551, 972.6060945317158, 984.4683870709808, 11066.889331106666, 11092.279001864934, 11096.0, 11112.611058612909, 11117.666470005914, 4032.7177097602885, 4236.152769446123, 4300.204462174508, 4323.1785960668, 4324.783760811947, 9295.814083718287, 9302.25581953442, 9398.0, 9406.38858474197, 9420.434773913586, 4607.9078418431445, 4658.673892827537, 4664.463586687574, 4678.789454474557, 4680.836170734008, 3784.8864534064023, 4055.148418832019, 4211.115665710236, 4236.555161708038, 4248.447701798808, 3663.6336366363685, 3664.3770559005034, 3781.0, 3782.6406491383273, 3794.715396345285, 1174.2543484887158, 1183.9704007399712, 1204.9578264760692, 1213.1204876464492, 1231.1566576894857, 678.725116327888, 772.8802035684478, 791.4934441957037, 834.5910503853069, 838.6058552480324, 5086.5422112009355, 5284.9471505284455, 5290.947090529045, 5386.784528618811, 5405.729713514309, 836.4312267658051, 873.6330741088758, 895.8253140637513, 896.6323807239, 903.5617725403174, 3532.788032718045, 3549.201429678353, 3580.5703315601772, 3582.4268117101137, 3657.5976642569294, 9115.179633832855, 9422.057794220524, 9513.667021654348, 9515.666951656798, 9540.045995400544, 9819.459929703935, 10018.599256029824, 10037.247206459544, 10066.194704423628, 10100.949495252624, 7550.811229719191, 7584.962075189699, 7648.502847314907, 7650.273224043707, 7673.884891726517, 5024.4473107957365, 5101.438841727481, 5140.974295128501, 5278.656887302313, 5288.867778305573, 9287.117723816227, 9377.202937750368, 9383.436993780395, 9431.292653051185, 9471.763205919908, 9141.131592498701, 9512.904870951203, 9574.808503830023, 9580.76048098803, 9605.039496050618, 5977.252843394575, 6356.396142366468, 6521.706523206372, 6590.340965903371, 6711.429528490133, 7741.380689544935, 7776.7278145264645, 7807.063152421746, 7808.609569521387, 7866.370690344873, 6684.465242780663, 6729.865402692017, 6790.7623233186605, 6831.180258369028, 7107.18267399235, 6777.423918966943, 6817.659117044227, 6841.0, 6916.0, 7022.4382049436945, 5708.714564271687, 5709.400512946247, 5756.769729210952, 5814.912776308274, 5837.5038121758425, 4234.682398820039, 4265.12564924196, 4341.826326946887, 4393.7363758174615, 4428.446444194476, 4334.0248444099825, 4393.275109606879, 4426.911461770811, 4498.2577874650315, 4499.865004049884], "value": 4174.131993801283, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [299.5177763800281, 303.2570203002643, 303.87541108145666, 309.35962557505974, 310.579165231112, 5134.409542902563, 5164.8120932185575, 5166.276721259027, 5172.224166375046, 5188.6367954243215, 5017.874553136165, 5037.118504261758, 5046.82336118236, 5055.671381360209, 5073.416557095935, 3729.8135093245364, 3839.8656047038357, 3942.0, 3983.7012224083164, 3997.4203740457615, 3972.801359932006, 4003.199360127986, 4004.2391945530403, 4021.617946295097, 4028.979855100735, 4002.8198731057173, 4009.619086186822, 4011.538673052607, 4013.6989725770536, 4023.9738866588978, 3809.942850857239, 4014.4179094031347, 4028.496437945242, 4034.0, 4040.6969477289026, 3553.9644603553893, 3567.4292113262013, 3568.80371579563, 3572.321258960815, 3576.337003293455, 5024.949750502521, 5053.8736531587, 5061.822836200715, 5063.569596584295, 5067.797288108472, 4527.954720452786, 4594.885127871797, 4633.976830115862, 4644.419447569054, 4647.744374059425, 5351.090314646481, 5351.652142610717, 5357.946420535784, 5362.678239305654, 5365.03429382711, 3852.84414675599, 3877.592852750449, 3878.5927477614728, 3880.47613572167, 3884.611538846121, 5466.234727138204, 5596.692181929992, 5620.0, 5643.887122257573, 5661.7735290588325, 3985.143194213258, 3989.960100399017, 3993.7204395692024, 4001.799910004488, 4012.518497780227, 4052.77709725962, 4061.7156799023783, 4065.6747460203114, 4070.0842310479907, 4087.05997620543, 4571.702839315434, 4593.6095431888, 4597.103564804898, 4598.839040633628, 4625.098105869323, 5204.5576126028955, 5321.441248668912, 5330.521307591988, 5374.301340825746, 5380.92381523689, 1387.5074348606302, 1398.1680899864564, 1408.295852073963, 1412.3150272118014, 1414.3069895751007, 885.5439448683933, 898.8651702244715, 926.5413620257881, 932.4871320773548, 933.5845548730886, 4552.84065057728, 4572.661956771575, 4587.311903214544, 4636.8145274188655, 4647.604953578983, 5353.357597088374, 5399.78400863961, 5423.3491980962535, 5444.50999410055, 5460.645058071213, 4452.1763473757455, 4595.471520775153, 4596.7931443085145, 4600.700954437951, 4618.815247390066, 2898.7680985521106, 2903.970960290412, 2905.680375158731, 2916.314666053476, 2930.853457327125, 5024.648274620815, 5037.319961805183, 5069.453816585903, 5079.72061536619, 5098.0, 5440.156775699773, 5526.309211348582, 5560.0, 5572.665640061609, 5576.581756368289, 5043.293938848564, 5097.974510127426, 5101.489851014943, 5132.127538318495, 5135.204043373283, 5419.0, 5421.701806400686, 5475.5072043516275, 5478.342598888159, 5502.889942201214, 5083.8053057530715, 5371.167469042305, 5375.838724838261, 5387.245785590099, 5397.109476936262, 5027.3464449621315, 5050.696958182521, 5092.032513822362, 5095.490450954875, 5096.770645321044, 3955.268275369066, 3956.40653901917, 3971.4638523798917, 3974.2647610192207, 3974.880753577397, 5286.950961831519, 5393.51458368733, 5418.674879507243, 5438.2325744134105, 5440.211169380338, 5236.9738151309, 5255.579553635624, 5280.20796880471, 5302.1781623848365, 5315.767377701297, 5073.974630126826, 5240.868978275421, 5279.287296214962, 5324.227986941949, 5325.733713314241, 5187.818426355059, 5199.870003249949, 5200.349956255468, 5208.401033881, 5217.530422262014, 5143.7428128594165, 5152.3044389007, 5280.339957505312, 5324.201369794562, 5415.945840541702, 5270.235815806764, 5276.498732620395, 5281.234221038005, 5281.867953301198, 5322.494363035506], "value": 4024.944417211049, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [665.7170702451458, 699.8285420072086, 739.8446326271483, 746.2574738135556, 757.1066141952497, 12233.938830305848, 12806.935965320185, 12950.0, 12963.351832408389, 13035.674108147301, 13027.28349940753, 13191.2744799036, 13283.667908302297, 13335.599932002031, 13420.194788312709, 757.8219118507146, 776.8873513340562, 777.8366543025971, 780.4887798491997, 782.5930516131608, 783.6591082878966, 783.8667426537473, 788.6254029336048, 790.3084800799301, 790.3519114326255, 811.7808191788214, 812.7358608452276, 815.9102498725135, 817.8446095241885, 822.0710597025353, 804.6700852650414, 807.4993504027511, 808.3331251717357, 808.8139727862624, 811.7808191788214, 592.0763608770332, 592.6266452135127, 594.2809200866956, 595.3064679648205, 597.4801922327559, 11891.464884080237, 11928.642140735792, 11931.224470409396, 11980.161388702794, 11988.820167697491, 11078.446077696164, 11161.107111431065, 11326.377049262288, 11481.024112950408, 11664.883351166465, 9777.804443911082, 9800.803983920281, 9812.803743925082, 9951.353162044516, 10104.494775261208, 3280.4259254630583, 3290.243244053881, 3313.7680362374645, 3401.183715908189, 3413.5221069050353, 42998.35502467434, 52056.21915671268, 53934.46065539333, 54452.72773636146, 57602.42397576055, 9405.341626086109, 9490.810183796286, 9683.709488715349, 9697.272704547187, 9713.514324283757, 18204.36284730028, 18298.0, 18447.90776046138, 18533.443996680122, 18997.240110395705, 7157.749478768218, 7173.497855150194, 7243.818904527429, 7262.419006479469, 7328.413726901942, 3884.7280690351968, 3964.0684439156776, 3977.244323578511, 3999.6200360965663, 4027.838886444568, 2876.4390943765766, 2965.7692057795775, 2969.8218106913223, 2978.836164010957, 2991.641003079644, 513.4531723714232, 514.2902794144057, 521.3795583255913, 533.1576109746591, 533.6131304803986, 506.4226781469128, 531.6305167908343, 546.7219011237086, 571.1404336473581, 579.0503574138417, 7461.607138403752, 7787.610619469004, 7926.088499822594, 8037.23646253605, 8399.454035487674, 447.8560505253105, 546.6610701365179, 573.9770409183669, 574.1932584718477, 574.5776854012298, 3866.3920158406336, 3938.7439816411843, 3965.484487016727, 3998.660113890352, 4024.3158663027357, 77998.0, 94445.0, 95228.0, 97925.0, 100334.0, 76124.23875761172, 78742.60628696819, 78925.0, 80975.59512202519, 81864.59067704623, 45630.31554526685, 53614.463855361726, 67491.0, 73865.0, 76543.2345676536, 8556.315494760529, 8632.784180395289, 8975.371723979259, 9014.467540518259, 9295.488748118918, 43134.56865431306, 43262.56737432711, 43680.34479482747, 43830.56169438393, 43943.0, 53095.46904530905, 60842.391576083675, 61306.69346653238, 61461.0, 61640.38359616346, 12310.322932238454, 12439.751204976032, 12526.498940042296, 12647.304398258184, 12648.367581620698, 12916.547920822726, 12999.552528215658, 13016.934915325362, 13212.603621891358, 13329.866701332863, 12738.490460381481, 12791.616251512469, 12952.222866628032, 13108.344582771015, 13426.731465370833, 11602.07183425307, 11667.474963626488, 11721.472533736172, 11912.76174476523, 11991.820122697993, 12130.0, 12144.271343719405, 12204.328761917825, 12248.203866748632, 12716.745665086832, 9888.208943284664, 9919.355241909252, 10024.799504010025, 10048.69853904384, 10264.538095785558, 9980.550875210778, 10261.179105671677, 10283.0, 10290.742731431774, 10389.896101038892], "value": 6490.6072823866925, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1563.3000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 114.0, 108.0, 114.0, 115.0, 116.0, 115.0, 116.0, 114.0, 115.0], "value": 113.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 123.0, 146.0, 171.0, 123.0, 154.0, 147.0, 123.0, 185.0, 122.0], "value": 144.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 163.0, 163.0, 168.0, 167.0, 164.0, 164.0, 164.0, 164.0, 163.0], "value": 164.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 76.0, 77.0, 156.0, 77.0, 77.0, 78.0, 83.0, 174.0, 77.0], "value": 95.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 86.0, 147.0, 85.0, 86.0, 85.0, 136.0, 85.0, 86.0, 136.0], "value": 101.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 118.0, 117.0, 117.0, 118.0, 118.0, 118.0, 119.0, 118.0], "value": 117.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 148.0, 151.0, 148.0, 149.0, 149.0, 150.0, 147.0, 148.0, 148.0], "value": 148.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 100.0, 95.0, 97.0, 95.0, 99.0, 99.0, 96.0], "value": 96.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 65.0, 66.0, 65.0, 66.0, 67.0, 64.0, 65.0, 64.0, 65.0], "value": 65.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 67.0, 65.0, 64.0, 65.0, 66.0, 66.0, 65.0, 65.0], "value": 65.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 78.0, 79.0, 78.0, 78.0, 79.0, 79.0, 80.0, 83.0, 88.0], "value": 80.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [132.0, 126.0, 132.0, 136.0, 140.0, 128.0, 134.0, 131.0, 163.0, 130.0], "value": 135.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 167.0, 167.0, 166.0, 169.0, 166.0, 166.0, 170.0, 164.0, 167.0], "value": 167.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 71.0, 66.0, 67.0, 66.0, 68.0, 68.0, 69.0, 66.0, 68.0], "value": 67.9, "unit": "score"}]}]} 04:04:57 INFO - Return code: 0 04:04:57 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:04:57 ERROR - # TBPL SUCCESS # 04:04:57 INFO - Running post-action listener: _resource_record_post_action 04:04:57 INFO - ##### 04:04:57 INFO - ##### Finished run-tests step (success) 04:04:57 INFO - ##### 04:04:57 INFO - Running post-run listener: _resource_record_post_run 04:04:57 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 4096; Write bytes: 534818816; Read time: 12; Write time: 400540 04:04:57 INFO - TinderboxPrint: CPU usage
13.3% 04:04:57 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 04:04:57 INFO - TinderboxPrint: I/O write bytes / time
534,818,816 / 400,540 04:04:57 INFO - TinderboxPrint: CPU idle
8,271.8 (86.7%) 04:04:57 INFO - TinderboxPrint: CPU user
1,219.9 (12.8%) 04:04:57 INFO - TinderboxPrint: Swap in / out
0 / 0 04:04:57 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 246312960; Read time: 0; Write time: 216888 04:04:57 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 0; Write bytes: 288505856; Read time: 0; Write time: 183652 04:04:57 INFO - Running post-run listener: _upload_blobber_files 04:04:57 INFO - Blob upload gear active. 04:04:57 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:04:57 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:04:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:04:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:04:58 INFO - (blobuploader) - INFO - Open directory for files ... 04:04:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:04:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:04:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:04:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:04:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:04:58 INFO - (blobuploader) - INFO - Done attempting. 04:04:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:04:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:04:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:04:59 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:04:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:04:59 INFO - (blobuploader) - INFO - Done attempting. 04:04:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:04:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:04:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:05:04 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:05:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:05:04 INFO - (blobuploader) - INFO - Done attempting. 04:05:04 INFO - (blobuploader) - INFO - Iteration through files over. 04:05:04 INFO - Return code: 0 04:05:04 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:05:04 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:05:04 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/fbe9f12afdbb3c21ef5ccb291a055c58cc085b8f877324805c131bf6170bc3bf8cf2d1fc4bcfadc8ebfe20683028032cef281714e7bfd434335d3acaef1f85e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e5b24195ed5409214311957f602361b441d773e7857162ae7b394081c7cf6520f609add092839dbecbc3dcd6e92a34895378a6054f79548b2f9e6725fc72de89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b1f772ff1dddda28723c967d74018be46c12fa290a2047f7eb2713edc36c6b7ee92d3009e6d422326bc5bda995a7aefd66677b1fda1aab77e7ed6257a3c9758d"} 04:05:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:05:04 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:05:04 INFO - Contents: 04:05:04 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/fbe9f12afdbb3c21ef5ccb291a055c58cc085b8f877324805c131bf6170bc3bf8cf2d1fc4bcfadc8ebfe20683028032cef281714e7bfd434335d3acaef1f85e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e5b24195ed5409214311957f602361b441d773e7857162ae7b394081c7cf6520f609add092839dbecbc3dcd6e92a34895378a6054f79548b2f9e6725fc72de89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b1f772ff1dddda28723c967d74018be46c12fa290a2047f7eb2713edc36c6b7ee92d3009e6d422326bc5bda995a7aefd66677b1fda1aab77e7ed6257a3c9758d"} 04:05:04 INFO - Running post-run listener: copy_logs_to_upload_dir 04:05:04 INFO - Copying logs to upload dir... 04:05:04 INFO - mkdir: /builds/slave/test/build/upload/logs 04:05:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1234.829160 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-07-01 04:05:04.673869) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-01 04:05:04.677787) ========= 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=4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/fbe9f12afdbb3c21ef5ccb291a055c58cc085b8f877324805c131bf6170bc3bf8cf2d1fc4bcfadc8ebfe20683028032cef281714e7bfd434335d3acaef1f85e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e5b24195ed5409214311957f602361b441d773e7857162ae7b394081c7cf6520f609add092839dbecbc3dcd6e92a34895378a6054f79548b2f9e6725fc72de89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b1f772ff1dddda28723c967d74018be46c12fa290a2047f7eb2713edc36c6b7ee92d3009e6d422326bc5bda995a7aefd66677b1fda1aab77e7ed6257a3c9758d"} build_url:https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011255 build_url: 'https://queue.taskcluster.net/v1/task/Ckkfhnz4T923IhmH-UxOqA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/fbe9f12afdbb3c21ef5ccb291a055c58cc085b8f877324805c131bf6170bc3bf8cf2d1fc4bcfadc8ebfe20683028032cef281714e7bfd434335d3acaef1f85e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e5b24195ed5409214311957f602361b441d773e7857162ae7b394081c7cf6520f609add092839dbecbc3dcd6e92a34895378a6054f79548b2f9e6725fc72de89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b1f772ff1dddda28723c967d74018be46c12fa290a2047f7eb2713edc36c6b7ee92d3009e6d422326bc5bda995a7aefd66677b1fda1aab77e7ed6257a3c9758d"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-01 04:05:04.704161) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 04:05:04.704629) ========= 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=4ac8d263c7293b36a1be1aed000001be-1467369868.76127-246193463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004358 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 04:05:04.788240) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-01 04:05:04.788608) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-01 04:05:04.788970) ========= ========= Total master_lag: 0.19 =========