builder: autoland_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-052 starttime: 1468856474.87 results: success (0) buildid: 20160718072552 builduid: e319786e38e346359de6b5fc6f2d1f52 revision: 102f746a6474f266c6ac3762c03d2f0d4ff32479 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:14.867976) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:14.868409) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:14.868680) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:14.897237) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:14.897529) ========= 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=826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-18 08:41:15-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.2M=0s 2016-07-18 08:41:15 (46.2 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.107828 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:15.023295) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:15.023593) ========= 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=826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017850 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:15.074635) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:15.074982) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev 102f746a6474f266c6ac3762c03d2f0d4ff32479 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev 102f746a6474f266c6ac3762c03d2f0d4ff32479 --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=826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-18 08:41:15,406 truncating revision to first 12 chars 2016-07-18 08:41:15,406 Setting DEBUG logging. 2016-07-18 08:41:15,406 attempt 1/10 2016-07-18 08:41:15,406 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/102f746a6474?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-18 08:41:15,980 unpacking tar archive at: autoland-102f746a6474/testing/mozharness/ program finished with exit code 0 elapsedTime=0.917804 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:16.006321) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:16.006591) ========= script_repo_revision: 102f746a6474f266c6ac3762c03d2f0d4ff32479 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:16.006974) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:16.007232) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-18 08:41:16.017616) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 47 secs) (at 2016-07-18 08:41:16.017881) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-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', 'Autoland-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland-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=826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:41:16 INFO - MultiFileLogger online at 20160718 08:41:16 in /builds/slave/test 08:41:16 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO 08:41:16 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:41:16 INFO - {'append_to_log': False, 08:41:16 INFO - 'base_work_dir': '/builds/slave/test', 08:41:16 INFO - 'blob_upload_branch': 'Autoland-Non-PGO', 08:41:16 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:41:16 INFO - 'branch': 'Autoland-Non-PGO', 08:41:16 INFO - 'buildbot_json_path': 'buildprops.json', 08:41:16 INFO - 'config_files': ('talos/linux_config.py',), 08:41:16 INFO - 'default_actions': ('clobber', 08:41:16 INFO - 'read-buildbot-config', 08:41:16 INFO - 'download-and-extract', 08:41:16 INFO - 'populate-webroot', 08:41:16 INFO - 'create-virtualenv', 08:41:16 INFO - 'install', 08:41:16 INFO - 'run-tests'), 08:41:16 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:41:16 INFO - 'download_minidump_stackwalk': True, 08:41:16 INFO - 'download_symbols': 'ondemand', 08:41:16 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:41:16 INFO - 'tooltool.py': '/tools/tooltool.py', 08:41:16 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:41:16 INFO - '/tools/misc-python/virtualenv.py')}, 08:41:16 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:41:16 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:41:16 INFO - 'installer_path': 'installer.exe', 08:41:16 INFO - 'log_level': 'info', 08:41:16 INFO - 'log_name': 'talos', 08:41:16 INFO - 'log_to_console': True, 08:41:16 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:41:16 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:41:16 INFO - 'opt_config_files': (), 08:41:16 INFO - 'pip_index': False, 08:41:16 INFO - 'sps_profile': False, 08:41:16 INFO - 'sps_profile_interval': 0, 08:41:16 INFO - 'suite': 'dromaeojs-e10s', 08:41:16 INFO - 'system_bits': '32', 08:41:16 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:41:16 INFO - 'title': 'talos-linux64-ix-052', 08:41:16 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:41:16 INFO - 'use_talos_json': True, 08:41:16 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:41:16 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:41:16 INFO - 'work_dir': 'build'} 08:41:16 INFO - ##### 08:41:16 INFO - ##### Running clobber step. 08:41:16 INFO - ##### 08:41:16 INFO - Running pre-action listener: _resource_record_pre_action 08:41:16 INFO - Running main action method: clobber 08:41:16 INFO - rmtree: /builds/slave/test/build 08:41:16 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:41:16 INFO - Running post-action listener: _resource_record_post_action 08:41:16 INFO - ##### 08:41:16 INFO - ##### Finished clobber step (success) 08:41:16 INFO - ##### 08:41:16 INFO - ##### 08:41:16 INFO - ##### Running read-buildbot-config step. 08:41:16 INFO - ##### 08:41:16 INFO - Running pre-action listener: _resource_record_pre_action 08:41:16 INFO - Running main action method: read_buildbot_config 08:41:16 INFO - Using buildbot properties: 08:41:16 INFO - { 08:41:16 INFO - "project": "", 08:41:16 INFO - "product": "firefox", 08:41:16 INFO - "script_repo_revision": "production", 08:41:16 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs-e10s", 08:41:16 INFO - "repository": "", 08:41:16 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland talos dromaeojs-e10s", 08:41:16 INFO - "buildid": "20160718072552", 08:41:16 INFO - "pgo_build": "False", 08:41:16 INFO - "basedir": "/builds/slave/test", 08:41:16 INFO - "buildnumber": 84, 08:41:16 INFO - "slavename": "talos-linux64-ix-052", 08:41:16 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:41:16 INFO - "platform": "ubuntu64_hw", 08:41:16 INFO - "scheduler": "tests-autoland-linux64-talos", 08:41:16 INFO - "branch": "autoland", 08:41:16 INFO - "repo_path": "integration/autoland", 08:41:16 INFO - "revision": "102f746a6474f266c6ac3762c03d2f0d4ff32479", 08:41:16 INFO - "stage_platform": "linux64", 08:41:16 INFO - "builduid": "e319786e38e346359de6b5fc6f2d1f52", 08:41:16 INFO - "slavebuilddir": "test" 08:41:16 INFO - } 08:41:16 INFO - Found installer url https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 08:41:16 INFO - Running post-action listener: _resource_record_post_action 08:41:16 INFO - ##### 08:41:16 INFO - ##### Finished read-buildbot-config step (success) 08:41:16 INFO - ##### 08:41:16 INFO - ##### 08:41:16 INFO - ##### Running download-and-extract step. 08:41:16 INFO - ##### 08:41:16 INFO - Running pre-action listener: _resource_record_pre_action 08:41:16 INFO - Running main action method: download_and_extract 08:41:16 INFO - mkdir: /builds/slave/test/build/tests 08:41:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:16 INFO - https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 08:41:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:41:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:41:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:18 INFO - Downloaded 1361 bytes. 08:41:18 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:41:18 INFO - Using the following test package requirements: 08:41:18 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 08:41:18 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:18 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:41:18 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:18 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 08:41:18 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:18 INFO - u'jsshell-linux-x86_64.zip'], 08:41:18 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:18 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:41:18 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 08:41:18 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:18 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:41:18 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:18 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:41:18 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:18 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:41:18 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:18 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:41:18 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:41:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:18 INFO - https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:41:18 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:41:18 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:41:18 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:19 INFO - Downloaded 22765373 bytes. 08:41:19 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'] 08:41:19 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 08:41:20 INFO - Return code: 0 08:41:20 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 08:41:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:20 INFO - https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:41:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:41:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:41:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:30 INFO - Downloaded 22765373 bytes. 08:41:30 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'] 08:41:30 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 08:41:32 INFO - Return code: 0 08:41:32 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')]} 08:41:32 INFO - https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:41:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 08:41:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 08:41:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:33 INFO - Downloaded 14403317 bytes. 08:41:33 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'] 08:41:33 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 08:41:33 INFO - Return code: 0 08:41: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')]} 08:41:33 INFO - https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:41:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:41:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:41:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QbqGuDgsQAunnCVQHgzRgA/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 08:41:35 INFO - Downloaded 57075726 bytes. 08:41:35 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:41:35 INFO - mkdir: /builds/slave/test/properties 08:41:35 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:41:35 INFO - Writing to file /builds/slave/test/properties/build_url 08:41:35 INFO - Contents: 08:41:35 INFO - build_url:https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:41:36 INFO - Running post-action listener: _resource_record_post_action 08:41:36 INFO - Running post-action listener: set_extra_try_arguments 08:41:36 INFO - ##### 08:41:36 INFO - ##### Finished download-and-extract step (success) 08:41:36 INFO - ##### 08:41:36 INFO - ##### 08:41:36 INFO - ##### Running populate-webroot step. 08:41:36 INFO - ##### 08:41:36 INFO - Running pre-action listener: _resource_record_pre_action 08:41:36 INFO - Running main action method: populate_webroot 08:41:36 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:41:36 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:41:36 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:41:36 INFO - '--tppagecycles', 08:41:36 INFO - '7'], 08:41:36 INFO - 'tests': ['tsvgm']}}, 08:41:36 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:41:36 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:41:36 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:41:36 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:41:36 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:36 INFO - 'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:41:36 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:36 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:41:36 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:36 INFO - 'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['damp', 'tps']}, 08:41:36 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:36 INFO - 'tests': ['damp', 'tps']}, 08:41:36 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['dromaeo_dom']}, 08:41:36 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:41:36 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['basic_compositor_video']}, 08:41:36 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:41:36 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['a11yr', 08:41:36 INFO - 'ts_paint', 08:41:36 INFO - 'tpaint', 08:41:36 INFO - 'sessionrestore', 08:41:36 INFO - 'sessionrestore_no_auto_restore', 08:41:36 INFO - 'tabpaint']}, 08:41:36 INFO - 'other-e10s': {'tests': ['a11yr', 08:41:36 INFO - 'ts_paint', 08:41:36 INFO - 'tpaint', 08:41:36 INFO - 'sessionrestore', 08:41:36 INFO - 'sessionrestore_no_auto_restore', 08:41:36 INFO - 'tabpaint']}, 08:41:36 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:41:36 INFO - 'ts_paint', 08:41:36 INFO - 'tpaint', 08:41:36 INFO - 'sessionrestore', 08:41:36 INFO - 'sessionrestore_no_auto_restore', 08:41:36 INFO - 'tabpaint']}, 08:41:36 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:41:36 INFO - 'ts_paint', 08:41:36 INFO - 'tpaint', 08:41:36 INFO - 'sessionrestore', 08:41:36 INFO - 'sessionrestore_no_auto_restore', 08:41:36 INFO - 'tabpaint']}, 08:41:36 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['a11yr', 08:41:36 INFO - 'ts_paint', 08:41:36 INFO - 'tpaint', 08:41:36 INFO - 'sessionrestore', 08:41:36 INFO - 'sessionrestore_no_auto_restore', 08:41:36 INFO - 'tabpaint']}, 08:41:36 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['a11yr', 08:41:36 INFO - 'ts_paint', 08:41:36 INFO - 'tpaint', 08:41:36 INFO - 'sessionrestore', 08:41:36 INFO - 'sessionrestore_no_auto_restore', 08:41:36 INFO - 'tabpaint']}, 08:41:36 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['tsvgx', 08:41:36 INFO - 'tsvgr_opacity', 08:41:36 INFO - 'tart', 08:41:36 INFO - 'tscrollx', 08:41:36 INFO - 'cart']}, 08:41:36 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:41:36 INFO - 'tsvgr_opacity', 08:41:36 INFO - 'tart', 08:41:36 INFO - 'tscrollx', 08:41:36 INFO - 'cart']}, 08:41:36 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:36 INFO - 'talos_options': ['--disable-e10s'], 08:41:36 INFO - 'tests': ['tp5o']}, 08:41:36 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:36 INFO - 'tests': ['tp5o']}, 08:41:36 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:36 INFO - 'talos_options': ['--disable-e10s', 08:41:36 INFO - '--xperf_path', 08:41:36 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:41:36 INFO - 'tests': ['tp5n']}, 08:41:36 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:36 INFO - 'talos_options': ['--xperf_path', 08:41:36 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:41:36 INFO - 'tests': ['tp5n']}}, 08:41:36 INFO - 'talos.zip': {'path': '', 08:41:36 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:41:36 INFO - Running post-action listener: _resource_record_post_action 08:41:36 INFO - ##### 08:41:36 INFO - ##### Finished populate-webroot step (success) 08:41:36 INFO - ##### 08:41:36 INFO - ##### 08:41:36 INFO - ##### Running create-virtualenv step. 08:41:36 INFO - ##### 08:41:36 INFO - Running pre-action listener: _resource_record_pre_action 08:41:36 INFO - Running main action method: create_virtualenv 08:41:36 INFO - Creating virtualenv /builds/slave/test/build/venv 08:41:36 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 08:41:36 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:41:36 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:41:36 INFO - Using real prefix '/usr' 08:41:36 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:41:36 INFO - Installing distribute.............................................................................................................................................................................................done. 08:41:38 INFO - Installing pip.................done. 08:41:38 INFO - Return code: 0 08:41:38 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:41:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 08:41:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 08:41:38 INFO - Using env: {'DISPLAY': ':0', 08:41:38 INFO - 'HOME': '/home/cltbld', 08:41:38 INFO - 'LANG': 'en_US.UTF-8', 08:41:38 INFO - 'LANGUAGE': 'en_US:en', 08:41:38 INFO - 'LOGNAME': 'cltbld', 08:41:38 INFO - 'MAIL': '/var/mail/cltbld', 08:41:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:38 INFO - 'MOZ_NO_REMOTE': '1', 08:41:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:38 INFO - 'NO_EM_RESTART': '1', 08:41:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:38 INFO - 'PWD': '/builds/slave/test', 08:41:38 INFO - 'SHELL': '/bin/bash', 08:41:38 INFO - 'SHLVL': '1', 08:41:38 INFO - 'TERM': 'linux', 08:41:38 INFO - 'TMOUT': '86400', 08:41:38 INFO - 'USER': 'cltbld', 08:41:38 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:38 INFO - '_': '/tools/buildbot/bin/python'} 08:41:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:38 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 08:41:38 INFO - Cleaning up... 08:41:38 INFO - Return code: 0 08:41:38 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:41:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 08:41:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 08:41:38 INFO - Using env: {'DISPLAY': ':0', 08:41:38 INFO - 'HOME': '/home/cltbld', 08:41:38 INFO - 'LANG': 'en_US.UTF-8', 08:41:38 INFO - 'LANGUAGE': 'en_US:en', 08:41:38 INFO - 'LOGNAME': 'cltbld', 08:41:38 INFO - 'MAIL': '/var/mail/cltbld', 08:41:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:38 INFO - 'MOZ_NO_REMOTE': '1', 08:41:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:38 INFO - 'NO_EM_RESTART': '1', 08:41:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:38 INFO - 'PWD': '/builds/slave/test', 08:41:38 INFO - 'SHELL': '/bin/bash', 08:41:38 INFO - 'SHLVL': '1', 08:41:38 INFO - 'TERM': 'linux', 08:41:38 INFO - 'TMOUT': '86400', 08:41:38 INFO - 'USER': 'cltbld', 08:41:38 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:38 INFO - '_': '/tools/buildbot/bin/python'} 08:41:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:39 INFO - Downloading/unpacking psutil>=3.1.1 08:41:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:41:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:41:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:41:41 INFO - Installing collected packages: psutil 08:41:41 INFO - Running setup.py install for psutil 08:41:41 INFO - building 'psutil._psutil_linux' extension 08:41:41 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 08:41:41 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 08:41:41 INFO - building 'psutil._psutil_posix' extension 08:41:41 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 08:41:41 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 08:41:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:41:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:41:41 INFO - Successfully installed psutil 08:41:41 INFO - Cleaning up... 08:41:41 INFO - Return code: 0 08:41:41 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:41: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')]} 08:41:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41: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')]} 08:41:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 08:41: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 mozsystemmonitor==0.3 08:41:41 INFO - Using env: {'DISPLAY': ':0', 08:41:41 INFO - 'HOME': '/home/cltbld', 08:41:41 INFO - 'LANG': 'en_US.UTF-8', 08:41:41 INFO - 'LANGUAGE': 'en_US:en', 08:41:41 INFO - 'LOGNAME': 'cltbld', 08:41:41 INFO - 'MAIL': '/var/mail/cltbld', 08:41:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:41 INFO - 'MOZ_NO_REMOTE': '1', 08:41:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:41 INFO - 'NO_EM_RESTART': '1', 08:41:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:41 INFO - 'PWD': '/builds/slave/test', 08:41:41 INFO - 'SHELL': '/bin/bash', 08:41:41 INFO - 'SHLVL': '1', 08:41:41 INFO - 'TERM': 'linux', 08:41:41 INFO - 'TMOUT': '86400', 08:41:41 INFO - 'USER': 'cltbld', 08:41:41 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:41 INFO - '_': '/tools/buildbot/bin/python'} 08:41:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:41 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:41:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:43 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:41:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:41:43 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:41:43 INFO - Installing collected packages: mozsystemmonitor 08:41:43 INFO - Running setup.py install for mozsystemmonitor 08:41:43 INFO - Successfully installed mozsystemmonitor 08:41:43 INFO - Cleaning up... 08:41:44 INFO - Return code: 0 08:41:44 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:41: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')]} 08:41:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41: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')]} 08:41:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41: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', '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 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 08:41: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 jsonschema==2.5.1 08:41:44 INFO - Using env: {'DISPLAY': ':0', 08:41:44 INFO - 'HOME': '/home/cltbld', 08:41:44 INFO - 'LANG': 'en_US.UTF-8', 08:41:44 INFO - 'LANGUAGE': 'en_US:en', 08:41:44 INFO - 'LOGNAME': 'cltbld', 08:41:44 INFO - 'MAIL': '/var/mail/cltbld', 08:41:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:44 INFO - 'MOZ_NO_REMOTE': '1', 08:41:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:44 INFO - 'NO_EM_RESTART': '1', 08:41:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:44 INFO - 'PWD': '/builds/slave/test', 08:41:44 INFO - 'SHELL': '/bin/bash', 08:41:44 INFO - 'SHLVL': '1', 08:41:44 INFO - 'TERM': 'linux', 08:41:44 INFO - 'TMOUT': '86400', 08:41:44 INFO - 'USER': 'cltbld', 08:41:44 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:44 INFO - '_': '/tools/buildbot/bin/python'} 08:41:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:44 INFO - Downloading/unpacking jsonschema==2.5.1 08:41: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 08:41: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 08:41: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 08:41: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 08:41: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 08:41: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 08:41:46 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:41:46 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:46 INFO - Downloading functools32-3.2.3-2.tar.gz 08:41:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:41:46 INFO - warning: no files found matching '*.txt' 08:41:46 INFO - no previously-included directories found matching 'build' 08:41:46 INFO - no previously-included directories found matching 'dist' 08:41:46 INFO - no previously-included directories found matching '.git*' 08:41:46 INFO - Installing collected packages: jsonschema, functools32 08:41:46 INFO - Running setup.py install for functools32 08:41:46 INFO - warning: no files found matching '*.txt' 08:41:46 INFO - no previously-included directories found matching 'build' 08:41:46 INFO - no previously-included directories found matching 'dist' 08:41:46 INFO - no previously-included directories found matching '.git*' 08:41:46 INFO - Successfully installed jsonschema functools32 08:41:46 INFO - Cleaning up... 08:41:46 INFO - Return code: 0 08:41:46 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:41:46 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')]} 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:46 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')]} 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:46 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 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41:46 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 08:41:46 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 08:41:46 INFO - Using env: {'DISPLAY': ':0', 08:41:46 INFO - 'HOME': '/home/cltbld', 08:41:46 INFO - 'LANG': 'en_US.UTF-8', 08:41:46 INFO - 'LANGUAGE': 'en_US:en', 08:41:46 INFO - 'LOGNAME': 'cltbld', 08:41:46 INFO - 'MAIL': '/var/mail/cltbld', 08:41:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:46 INFO - 'MOZ_NO_REMOTE': '1', 08:41:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:46 INFO - 'NO_EM_RESTART': '1', 08:41:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:46 INFO - 'PWD': '/builds/slave/test', 08:41:46 INFO - 'SHELL': '/bin/bash', 08:41:46 INFO - 'SHLVL': '1', 08:41:46 INFO - 'TERM': 'linux', 08:41:46 INFO - 'TMOUT': '86400', 08:41:46 INFO - 'USER': 'cltbld', 08:41:46 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:46 INFO - '_': '/tools/buildbot/bin/python'} 08:41:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:46 INFO - Downloading/unpacking blobuploader==1.2.4 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:48 INFO - Downloading blobuploader-1.2.4.tar.gz 08:41:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:41:48 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:41:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:41:49 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:41: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 08:41: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 08:41: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 08:41: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 08:41: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 08:41: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 08:41:49 INFO - Downloading docopt-0.6.1.tar.gz 08:41:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:41:49 INFO - Installing collected packages: blobuploader, requests, docopt 08:41:49 INFO - Running setup.py install for blobuploader 08:41:49 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:41:49 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:41:49 INFO - Running setup.py install for requests 08:41:49 INFO - Running setup.py install for docopt 08:41:50 INFO - Successfully installed blobuploader requests docopt 08:41:50 INFO - Cleaning up... 08:41:50 INFO - Return code: 0 08:41:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:41:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:50 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 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41:50 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 08:41:50 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 08:41:50 INFO - Using env: {'DISPLAY': ':0', 08:41:50 INFO - 'HOME': '/home/cltbld', 08:41:50 INFO - 'LANG': 'en_US.UTF-8', 08:41:50 INFO - 'LANGUAGE': 'en_US:en', 08:41:50 INFO - 'LOGNAME': 'cltbld', 08:41:50 INFO - 'MAIL': '/var/mail/cltbld', 08:41:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:50 INFO - 'MOZ_NO_REMOTE': '1', 08:41:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:50 INFO - 'NO_EM_RESTART': '1', 08:41:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:50 INFO - 'PWD': '/builds/slave/test', 08:41:50 INFO - 'SHELL': '/bin/bash', 08:41:50 INFO - 'SHLVL': '1', 08:41:50 INFO - 'TERM': 'linux', 08:41:50 INFO - 'TMOUT': '86400', 08:41:50 INFO - 'USER': 'cltbld', 08:41:50 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:50 INFO - '_': '/tools/buildbot/bin/python'} 08:41:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:41:50 INFO - Running setup.py (path:/tmp/pip-Vy2__J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:41:50 INFO - Running setup.py (path:/tmp/pip-NS4dKL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:41:50 INFO - Running setup.py (path:/tmp/pip-qzYG9M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:41:50 INFO - Running setup.py (path:/tmp/pip-blcKdn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:41:50 INFO - Running setup.py (path:/tmp/pip-fAUtwM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:41:50 INFO - Running setup.py (path:/tmp/pip-75gciP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:41:50 INFO - Running setup.py (path:/tmp/pip-6t0m_2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:41:50 INFO - Running setup.py (path:/tmp/pip-OeU0UT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:41:50 INFO - Running setup.py (path:/tmp/pip-vDVWbJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:41:50 INFO - Running setup.py (path:/tmp/pip-CMDd4H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:41:51 INFO - Running setup.py (path:/tmp/pip-hvRnV5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:41:51 INFO - Running setup.py (path:/tmp/pip-4G3x6_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:41:51 INFO - Running setup.py (path:/tmp/pip-4LWBg3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:41:51 INFO - Running setup.py (path:/tmp/pip-b8Vma4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:41:51 INFO - Running setup.py (path:/tmp/pip-UuFqPk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:41:51 INFO - Running setup.py (path:/tmp/pip-F0EqvS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:41:51 INFO - Running setup.py (path:/tmp/pip-R1QOpS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:41:51 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:41:51 INFO - Running setup.py install for manifestparser 08:41:51 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:41:51 INFO - Running setup.py install for mozcrash 08:41:51 INFO - Running setup.py install for mozdebug 08:41:51 INFO - Running setup.py install for mozdevice 08:41:51 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:41:51 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:41:51 INFO - Running setup.py install for mozfile 08:41:52 INFO - Running setup.py install for mozhttpd 08:41:52 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Running setup.py install for mozinfo 08:41:52 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Running setup.py install for mozInstall 08:41:52 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Running setup.py install for mozleak 08:41:52 INFO - Running setup.py install for mozlog 08:41:52 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Running setup.py install for moznetwork 08:41:52 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Running setup.py install for mozprocess 08:41:52 INFO - Running setup.py install for mozprofile 08:41:52 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:41:52 INFO - Running setup.py install for mozrunner 08:41:53 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:41:53 INFO - Running setup.py install for mozscreenshot 08:41:53 INFO - Running setup.py install for moztest 08:41:53 INFO - Running setup.py install for mozversion 08:41:53 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:41:53 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:41:53 INFO - Cleaning up... 08:41:53 INFO - Return code: 0 08:41:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:41: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')]} 08:41:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41: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')]} 08:41:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:53 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 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41:53 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 08:41:53 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 08:41:53 INFO - Using env: {'DISPLAY': ':0', 08:41:53 INFO - 'HOME': '/home/cltbld', 08:41:53 INFO - 'LANG': 'en_US.UTF-8', 08:41:53 INFO - 'LANGUAGE': 'en_US:en', 08:41:53 INFO - 'LOGNAME': 'cltbld', 08:41:53 INFO - 'MAIL': '/var/mail/cltbld', 08:41:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:53 INFO - 'MOZ_NO_REMOTE': '1', 08:41:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:53 INFO - 'NO_EM_RESTART': '1', 08:41:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:53 INFO - 'PWD': '/builds/slave/test', 08:41:53 INFO - 'SHELL': '/bin/bash', 08:41:53 INFO - 'SHLVL': '1', 08:41:53 INFO - 'TERM': 'linux', 08:41:53 INFO - 'TMOUT': '86400', 08:41:53 INFO - 'USER': 'cltbld', 08:41:53 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:53 INFO - '_': '/tools/buildbot/bin/python'} 08:41:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:41:53 INFO - Running setup.py (path:/tmp/pip-ZpbBEn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:41:53 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:41:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:41:53 INFO - Running setup.py (path:/tmp/pip-m2hCbV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:41:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:41:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:41:53 INFO - Running setup.py (path:/tmp/pip-OzRHvw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:41:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:41:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:41:53 INFO - Running setup.py (path:/tmp/pip-ElbfcE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:41:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:41:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:41:53 INFO - Running setup.py (path:/tmp/pip-6Ea7gn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:41:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:41:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:41:53 INFO - Running setup.py (path:/tmp/pip-mikxwe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:41:54 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)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:41:54 INFO - Running setup.py (path:/tmp/pip-ncgFvL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:41:54 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)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:41:54 INFO - Running setup.py (path:/tmp/pip-olXw0t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:41:54 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)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:41:54 INFO - Running setup.py (path:/tmp/pip-5xhOJA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:41:54 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)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:41:54 INFO - Running setup.py (path:/tmp/pip-m13YGB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:41:54 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)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:41:54 INFO - Running setup.py (path:/tmp/pip-BINcvz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:41:54 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)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:41:54 INFO - Running setup.py (path:/tmp/pip-xw4TmU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:41:54 INFO - Running setup.py (path:/tmp/pip-gdBACW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:41:54 INFO - Running setup.py (path:/tmp/pip-G3BYZk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:41:54 INFO - Running setup.py (path:/tmp/pip-ZlrfNr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:41:54 INFO - Running setup.py (path:/tmp/pip-lKHruz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:41:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:41:54 INFO - Running setup.py (path:/tmp/pip-8bQKPO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:41:54 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:41:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:56 INFO - Downloading blessings-1.6.tar.gz 08:41:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:41:56 INFO - Installing collected packages: blessings 08:41:56 INFO - Running setup.py install for blessings 08:41:56 INFO - Successfully installed blessings 08:41:56 INFO - Cleaning up... 08:41:56 INFO - Return code: 0 08:41:56 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:41:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:41:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:41:57 INFO - Reading from file tmpfile_stdout 08:41:57 INFO - Current package versions: 08:41:57 INFO - argparse == 1.2.1 08:41:57 INFO - blessings == 1.6 08:41:57 INFO - blobuploader == 1.2.4 08:41:57 INFO - docopt == 0.6.1 08:41:57 INFO - functools32 == 3.2.3-2 08:41:57 INFO - jsonschema == 2.5.1 08:41:57 INFO - manifestparser == 1.1 08:41:57 INFO - mozInstall == 1.12 08:41:57 INFO - mozcrash == 0.17 08:41:57 INFO - mozdebug == 0.1 08:41:57 INFO - mozdevice == 0.48 08:41:57 INFO - mozfile == 1.2 08:41:57 INFO - mozhttpd == 0.7 08:41:57 INFO - mozinfo == 0.9 08:41:57 INFO - mozleak == 0.1 08:41:57 INFO - mozlog == 3.2 08:41:57 INFO - moznetwork == 0.27 08:41:57 INFO - mozprocess == 0.23 08:41:57 INFO - mozprofile == 0.28 08:41:57 INFO - mozrunner == 6.12 08:41:57 INFO - mozscreenshot == 0.1 08:41:57 INFO - mozsystemmonitor == 0.3 08:41:57 INFO - moztest == 0.7 08:41:57 INFO - mozversion == 1.4 08:41:57 INFO - psutil == 3.1.1 08:41:57 INFO - requests == 1.2.3 08:41:57 INFO - wsgiref == 0.1.2 08:41:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:41:57 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')]} 08:41:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:57 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')]} 08:41:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:57 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 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41:57 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 08:41:57 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 08:41:57 INFO - Using env: {'DISPLAY': ':0', 08:41:57 INFO - 'HOME': '/home/cltbld', 08:41:57 INFO - 'LANG': 'en_US.UTF-8', 08:41:57 INFO - 'LANGUAGE': 'en_US:en', 08:41:57 INFO - 'LOGNAME': 'cltbld', 08:41:57 INFO - 'MAIL': '/var/mail/cltbld', 08:41:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:57 INFO - 'MOZ_NO_REMOTE': '1', 08:41:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:57 INFO - 'NO_EM_RESTART': '1', 08:41:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:57 INFO - 'PWD': '/builds/slave/test', 08:41:57 INFO - 'SHELL': '/bin/bash', 08:41:57 INFO - 'SHLVL': '1', 08:41:57 INFO - 'TERM': 'linux', 08:41:57 INFO - 'TMOUT': '86400', 08:41:57 INFO - 'USER': 'cltbld', 08:41:57 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:57 INFO - '_': '/tools/buildbot/bin/python'} 08:41:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 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)) 08:41:57 INFO - Cleaning up... 08:41:57 INFO - Return code: 0 08:41:57 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:41:57 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')]} 08:41:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:57 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')]} 08:41:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:57 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 0x11cf030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13fe400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, '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': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', '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 08:41:57 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 08:41:57 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 08:41:57 INFO - Using env: {'DISPLAY': ':0', 08:41:57 INFO - 'HOME': '/home/cltbld', 08:41:57 INFO - 'LANG': 'en_US.UTF-8', 08:41:57 INFO - 'LANGUAGE': 'en_US:en', 08:41:57 INFO - 'LOGNAME': 'cltbld', 08:41:57 INFO - 'MAIL': '/var/mail/cltbld', 08:41:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:57 INFO - 'MOZ_NO_REMOTE': '1', 08:41:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:57 INFO - 'NO_EM_RESTART': '1', 08:41:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:57 INFO - 'PWD': '/builds/slave/test', 08:41:57 INFO - 'SHELL': '/bin/bash', 08:41:57 INFO - 'SHLVL': '1', 08:41:57 INFO - 'TERM': 'linux', 08:41:57 INFO - 'TMOUT': '86400', 08:41:57 INFO - 'USER': 'cltbld', 08:41:57 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:41:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:57 INFO - '_': '/tools/buildbot/bin/python'} 08:41:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:57 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:41:57 INFO - Cleaning up... 08:41:57 INFO - Return code: 0 08:41:57 INFO - Running post-action listener: _resource_record_post_action 08:41:57 INFO - Running post-action listener: _start_resource_monitoring 08:41:57 INFO - Starting resource monitoring. 08:41:57 INFO - ##### 08:41:57 INFO - ##### Finished create-virtualenv step (success) 08:41:57 INFO - ##### 08:41:57 INFO - ##### 08:41:57 INFO - ##### Running install step. 08:41:57 INFO - ##### 08:41:57 INFO - Running pre-action listener: _resource_record_pre_action 08:41:57 INFO - Running main action method: install 08:41:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:41:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:41:57 INFO - Reading from file tmpfile_stdout 08:41:57 INFO - Detecting whether we're running mozinstall >=1.0... 08:41:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:41:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:41:57 INFO - Reading from file tmpfile_stdout 08:41:57 INFO - Output received: 08:41:57 INFO - Usage: mozinstall [options] installer 08:41:57 INFO - Options: 08:41:57 INFO - -h, --help show this help message and exit 08:41:57 INFO - -d DEST, --destination=DEST 08:41:57 INFO - Directory to install application into. [default: 08:41:57 INFO - "/builds/slave/test"] 08:41:57 INFO - --app=APP Application being installed. [default: firefox] 08:41:57 INFO - mkdir: /builds/slave/test/build/application 08:41:57 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'] 08:41:57 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 08:42:14 INFO - Reading from file tmpfile_stdout 08:42:14 INFO - Output received: 08:42:14 INFO - /builds/slave/test/build/application/firefox/firefox 08:42:14 INFO - Running post-action listener: _resource_record_post_action 08:42:14 INFO - ##### 08:42:14 INFO - ##### Finished install step (success) 08:42:14 INFO - ##### 08:42:14 INFO - ##### 08:42:14 INFO - ##### Running run-tests step. 08:42:14 INFO - ##### 08:42:14 INFO - Running pre-action listener: _resource_record_pre_action 08:42:14 INFO - Running main action method: run_tests 08:42:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:42:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:42:14 INFO - Python 2.7.3 08:42:14 INFO - Return code: 0 08:42:14 INFO - grabbing minidump binary from tooltool 08:42:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:42:14 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 0x148d570>, '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 0x148e470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x148e900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:42:14 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 08:42:14 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 08:42:14 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 08:42:14 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:42:14 INFO - Return code: 0 08:42:14 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:42:14 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:42:14 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:42:14 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:42:14 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:42:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-052', '--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 08:42:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-052 --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 08:42:14 INFO - Using env: {'DISPLAY': ':0', 08:42:14 INFO - 'HOME': '/home/cltbld', 08:42:14 INFO - 'LANG': 'en_US.UTF-8', 08:42:14 INFO - 'LANGUAGE': 'en_US:en', 08:42:14 INFO - 'LOGNAME': 'cltbld', 08:42:14 INFO - 'MAIL': '/var/mail/cltbld', 08:42:14 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:42:14 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:42:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:42:14 INFO - 'MOZ_NO_REMOTE': '1', 08:42:14 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:42:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:42:14 INFO - 'NO_EM_RESTART': '1', 08:42:14 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:42:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:42:14 INFO - 'PWD': '/builds/slave/test', 08:42:14 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:42:14 INFO - 'SHELL': '/bin/bash', 08:42:14 INFO - 'SHLVL': '1', 08:42:14 INFO - 'TERM': 'linux', 08:42:14 INFO - 'TMOUT': '86400', 08:42:14 INFO - 'USER': 'cltbld', 08:42:14 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616', 08:42:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:42:14 INFO - '_': '/tools/buildbot/bin/python'} 08:42:14 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-052', '--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 08:42:14 INFO - mozversion application_buildid: 20160718072552 08:42:14 INFO - mozversion application_changeset: 102f746a6474f266c6ac3762c03d2f0d4ff32479 08:42:14 INFO - mozversion application_display_name: Nightly 08:42:14 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:42:14 INFO - mozversion application_name: Firefox 08:42:14 INFO - mozversion application_remotingname: firefox 08:42:14 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 08:42:14 INFO - mozversion application_vendor: Mozilla 08:42:14 INFO - mozversion application_version: 50.0a1 08:42:14 INFO - mozversion platform_buildid: 20160718072552 08:42:14 INFO - mozversion platform_changeset: 102f746a6474f266c6ac3762c03d2f0d4ff32479 08:42:14 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 08:42:14 INFO - mozversion platform_version: 50.0a1 08:42:14 INFO - using testdate: 1468856534 08:42:14 INFO - actual date: 1468856534 08:42:14 INFO - starting webserver on 'localhost:34594' 08:42:14 INFO - SUITE-START | Running 2 tests 08:42:14 INFO - TEST-START | dromaeo_css 08:42:14 INFO - operating with platform_type : linux_ 08:42:14 INFO - Initialising browser for dromaeo_css test... 08:42:14 INFO - TEST-INFO | started process 29877 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmphxUExZ/profile http://localhost:34594/getInfo.html) 08:42:17 INFO - PROCESS | 29877 | JavaScript error: , line 0: uncaught exception: undefined 08:42:19 INFO - PROCESS | 29877 | __metrics Screen width/height:1600/1200 08:42:19 INFO - PROCESS | 29877 | colorDepth:24 08:42:19 INFO - PROCESS | 29877 | Browser inner width/height: 1024/697 08:42:19 INFO - PROCESS | 29877 | __metrics 08:42:19 ERROR - PROCESS | 29877 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 08:42:20 INFO - TEST-INFO | 29877: exit 0 08:42:20 INFO - Browser initialized. 08:42:20 INFO - Running cycle 1/1 for dromaeo_css test... 08:42:20 INFO - TEST-INFO | started process 29998 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmphxUExZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:42:32 INFO - PROCESS | 29998 | RSS: Main: 169406464 08:42:32 INFO - PROCESS | 29998 | 08:43:22 INFO - PROCESS | 29998 | 1468856602022 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] 08:45:36 INFO - PROCESS | 29998 | Cycle 1(1): loaded http://localhost:34594/tests/dromaeo/cssquery-dojo.html (next: http://localhost:34594/tests/dromaeo/cssquery-ext.html) 08:45:37 INFO - PROCESS | 29998 | RSS: Main: 170115072 08:45:37 INFO - PROCESS | 29998 | 08:48:39 INFO - PROCESS | 29998 | Cycle 1(1): loaded http://localhost:34594/tests/dromaeo/cssquery-ext.html (next: http://localhost:34594/tests/dromaeo/cssquery-jquery.html) 08:48:40 INFO - PROCESS | 29998 | RSS: Main: 170524672 08:48:40 INFO - PROCESS | 29998 | 08:51:41 INFO - PROCESS | 29998 | Cycle 1(1): loaded http://localhost:34594/tests/dromaeo/cssquery-jquery.html (next: http://localhost:34594/tests/dromaeo/cssquery-mootools.html) 08:51:42 INFO - PROCESS | 29998 | RSS: Main: 173162496 08:51:42 INFO - PROCESS | 29998 | 08:54:44 INFO - PROCESS | 29998 | Cycle 1(1): loaded http://localhost:34594/tests/dromaeo/cssquery-mootools.html (next: http://localhost:34594/tests/dromaeo/cssquery-prototype.html) 08:54:45 INFO - PROCESS | 29998 | RSS: Main: 168218624 08:54:45 INFO - PROCESS | 29998 | 08:57:48 INFO - PROCESS | 29998 | Cycle 1(1): loaded http://localhost:34594/tests/dromaeo/cssquery-prototype.html (next: http://localhost:34594/tests/dromaeo/cssquery-yui.html) 08:57:48 INFO - PROCESS | 29998 | RSS: Main: 169984000 08:57:48 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | Cycle 1(1): loaded http://localhost:34594/tests/dromaeo/cssquery-yui.html (next: http://localhost:34594/tests/dromaeo/cssquery-dojo.html) 09:00:51 INFO - PROCESS | 29998 | RSS: Main: 173617152 09:00:51 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | __start_tp_report 09:00:51 INFO - PROCESS | 29998 | _x_x_mozilla_page_load 09:00:51 INFO - PROCESS | 29998 | _x_x_mozilla_page_load_details 09:00:51 INFO - PROCESS | 29998 | |i|pagename|runs| 09:00:51 INFO - PROCESS | 29998 | |0;dojo.html;2654.694710108338;2703.7161098084707;2717.95923061154;2718.021512255588;2727.83632982021;4794.400699912511;4879.951200487994;4881.194602890523;4907.0676571451395;5002.124628190061;4676.462206846214;4806.134895718769;4809.398825146856;4868.294097355882;4935.407751069876;4387.583179597933;4411.113378154436;4531.161735079005;4539.523350048247;4540.250858608326;566.3512188653278;4339.023719663082;4382.298832186851;4412.933805992912;4429.335599660045;4463.040446304028;4467.776611169428;4482.551744825524;4514.413126293561;4525.32120181972;4462.955370446286;4463.620592249663;4465.754383508905;4479.216137175981;4505.166544189336;4332.155229730204;4375.234333991539;4383.517813040563;4410.735355878625;4475.2168370535355;4801;4807.326974223612;4820.204666230068;4836.685615435021;4923.655344125877;5169.043726910533;5192.662476938987;5210.062188806013;5211.7133557654315;5220.530152286275;5126.282320475137;5203.505666961632;5229.633925625208;5234.947650523484;5235.528802407764;4793.880152996203;4828.686135401188;4830.7101573905675;4839.032193561302;4875.07373599015;5146.511081447256;5246.055709972242;5299.12564426873;5310.893782124336;5324.387695415076;5085.796568137307;5109.4379618241965;5128.153854614022;5130.410002849645;5138.126518491866;5164.561012313995;5179.2749015137915;5181.196914478187;5205.349331333583;5209.531142197145;4973.9554693514765;5064.594832413398;5092.541671249605;5112.309838171799;5114.616403769732;5093.974530127326;5102.668326558762;5108.846734597968;5117.948820511821;5160.535551800356;4403.515613282536;4404.383386325917;4410.514843367227;4451.221036318631;4474.082813023322;3753.9812300938866;3840.558335791364;3841.5774264830848;3847.1343947611563;3858.7298889078056;4381.7370957742;4471.06107717383;4490.797914093873;4502.077074199781;4522.886927826765;5274.551663108602;5287.127623942083;5289.841304760864;5296.152615581488;5334.146536554133;4360.040791025969;4491.326301054803;4530.796114174804;4537.705049171794;4556.066006468666;4735.59747421473;4758.690685105457;4761.35721677576;4761.928571071437;4789.928151077736;4878.634102442402;4940.431850337113;4942.8022879085875;4942.8517144484285;4993.425756038102;5124.436312005751;5171.50870667286;5188.507091826271;5211.296474975981;5254.15933450646;4861;4863.051704917649;4868.391451068616;4879.902401952012;4920.483349248278;5005.074061298671;5113.258577506315;5129.8974020518635;5151.5363617274625;5156.9742151289;5085.7711402986215;5109.821156259513;5111.258867464123;5125.589952803842;5166.173412254021;4977.427595826382;4990.6506544541535;4991.450940396626;4996.525330093636;5040.974795126001;4902.14212512816;4965.577925876341;4984.925226121539;4987.351644286365;5029.44676085623;4883.243097319921;4896.6572339935865;4913.484084171254;4925.679830810986;4959.280904268933;5071.112555302733;5077.365329333833;5078.97460512695;5091.210862316347;5092.287079808756;4944.332515110414;5004.2493625956395;5029.245613157909;5043.940772437829;5066.59467242627 09:00:51 INFO - PROCESS | 29998 | |1;ext.html;561.2619405481792;565.0225110558731;575.8790653962668;576.9567282453817;600.1148306248288;33588.32823343531;38293.617063829355;38565.421518677205;38573.61426385735;38593;30623.23441913953;30909.690903090963;30927.381452370995;31135.221619459524;31150.688493115118;7723.382129429646;7809.219078092174;7868.803279917991;7871.212878712112;7874.606269686521;7631.961840190791;7689.538627682357;7694.230576942317;7720.884186737204;7741.071071471403;7712.15166331703;7751.341136003446;7767;7777.5333479991095;7779.105402878657;7665.731699390494;7705.190954949734;7751.457397982143;7754.495957762728;7766;7648.961755191244;7651.808704782369;7725.729599463992;7731.110922243957;7731.690732370698;38008;38063;38400;38422.80788596039;38450;2982.2693440107314;3001.969980300191;3024.1683537027275;3132.342208136294;3293.226091868409;29331;29517;29585.852070739507;29795.55306670402;30248.54627180594;3168.1287645897332;3210.4060748761553;3219.404410184123;3244.967550324514;3276.025986372993;249640;252508;253623;253784;254188;53968.73015634897;54601.45398546043;54707.45292547103;54767.45232547703;54874.72562637241;33366.3326733464;34219.828900855835;34460.31079378398;36470.45294320587;36555.26889462196;13738.65653358654;13931.791023134661;13962.650933726534;14048.929755351157;14074.859251407559;10974.176936729777;11271.49278282463;11293.096552275798;11307.830382544269;11307.830382544269;18485.81514184841;18560.25758969653;18567.628647426976;18654.16056277471;18672.253109875724;6950.79147625572;6983.406410455168;7040.3663670269925;7094.68073936674;7097.858042839114;824.5629816197305;914.8353296406577;940.1961323068814;1001.3040936549029;1019.0624625344701;27814.582781258297;28047.859760701067;28080;28470.430591388056;28490.430191396055;954.0459540459541;966.3622009473854;981.4798156976814;982.2780256511459;1077.7197928538637;14776.63058423548;15030.774538381933;15116.209832681607;15169.848301517064;15284.617884552976;400192;403646;408154;408925;410294;52452.21321680178;52652.47347526552;52693.209601856004;52906.735466322425;53016.20475692867;1182.781185480689;1187.8337032815414;1192.5706745571588;1196.6529706385224;1196.6948428150765;26961.73038269592;26967.460650787267;28041.298967525974;28252.576211356434;28315.858420708588;43939.12121757483;44386.11227775491;44480.777596113105;44502.77748611236;44570;368489;376554;376767;379027;379736;25910;26017.219483415527;26251.73748262493;26307.868460657573;26311.868440657676;42813;43883.561164389226;44146.558534414246;44224.7788761067;44643;37193.628063719014;38260;38301.42547861728;38512.80743596264;38980.80509597434;37242.44136337903;37422.12631819661;38046.239075218895;38305.425418618186;38553.80723096366;36205.45691814572;36890.26219475649;37105.628943711294;37353.6264637361;37569;32082.51876221812;33819.4927076099;33863.661363386054;33979;34062;25781.484370312864;25955;26198.476030479665;26203.344916377242;26533.867330663223 09:00:51 INFO - PROCESS | 29998 | |2;jquery.html;364.99999999999994;367.27463260061376;378.292592851368;383.63937898375525;393.5867339293741;16387.672246555063;16819.41132060378;17452.56368590786;17566.824331756678;17649.294028238855;15783.28975196116;16260.349586016575;17201.483955481322;17212.569685757862;17225.82774172258;4914.705117692941;5073.061483625541;5076.771545280453;5092.439831618519;5109.514596113363;4971.975140124295;4984.551390374865;5006.874828129289;5042.974785126069;5082.949170508303;4958.429780575226;5047.47001564834;5050.873728156789;5087.84736457905;5093.745312734367;5017.724025178613;5023.673461225008;5086;5092.210707340369;5098.821541246057;4459.0413061192;4480.843170489017;4491.4161159049445;4492.213862574069;4495.797689103998;20117.597648047104;20263.392098237076;20653.79346206549;20812.895935520377;20829;1697.4822679082874;1786.178357955342;1806.7560879281261;1844.6587381334496;1967.4884530022298;5251.6061295403;7578.886316705254;9209.631614735403;9643.180329671986;9669.17811985982;1775.6626241014294;1782.5632719983687;1825.3520000399799;1838.9816101838944;1867.953301167468;68267;70308.6484567574;70576;71597.28402715958;72697.27302726958;9363.719088427359;9504.904950950402;9724.319297649097;9728.951355243178;9768.51157442125;12889.48442062307;12895.935520322339;12950.417231224617;12968.8054679178;13024.54414095502;6959.617221052789;7022.438204943593;7239.348458638748;7387.150477695026;7398.926010739824;7098.3256590623805;7104.21853596104;7113.608751518716;7235.240299768554;7255;3958.8218530166214;3961.2275606256503;3979.801009949491;4095.774732389747;4149.605787450248;1634.2890842483557;1671.690737213595;1674.7990241171137;1699.4646686293777;1709.8290170982802;856.4090777363599;864;902.8374892519279;923.2660035271975;955.5031383680447;16369.525167884787;16939;17799.110044497982;17957.640847183244;18075.909620451814;819.8893149424752;869.2437579305918;905.4567259644292;926.4117285523606;930.5672862119147;9754.414735115915;9915.405075695482;9925.702228933143;9963.252756043326;10097.646582369582;378882;388355;393743;407226;412814;49304.506954929995;49495.20607645374;49570.25644615333;81587.59206203932;85278;915.6337465014047;916.5875356089653;936.6347124621403;947.8056998315467;949.5632009275672;15471.613209669847;15709.764353534934;15944.681106377575;15969.840301596836;15974.322696117206;38052.61947380491;38416;38793.418098729104;39238.80380598079;39463.21073578455;51123;55237.72381138069;55590.72204638951;55713;55774.44225557693;7052.259512751088;7145.428365730625;7224.494285399972;7490.400767938443;7578.09062912454;10437.843432348369;11154.274972126786;11280.09759219244;11380.601678941197;11617.419129043683;9736.464494452874;9805.558749856416;9853.852192216978;10171.7457063574;10185.287029908131;9844.753881153028;9903.50482475859;9919.454430006419;10080.64717734905;10138.594456221963;9755.658551950648;9808.215342772419;9854.408735475894;9989.150922171697;10016.799664006825;7111.7866464006165;7179.964100179465;7194.532355396883;7262.636868156465;7326.267373262631;8132.837343252983;9613.230941524522;10000.949995249977;10015.649452269136;10312.948435258077 09:00:51 INFO - PROCESS | 29998 | |3;mootools.html;1346.347021694478;1388.5348408283226;1464.319091622396;1667.2747354900612;1703.889247198932;6875.7249710011665;7512.924870751291;7698.7690369288875;8044.276015158634;8093.473924194931;7757.495762775416;7897.881531777028;8075.878861817077;8078.151794061627;8085.555294458803;2162.0811155258993;2191.2111639809655;2192.3970908000347;2195.7913998170147;2200.526886719355;2153.2033147735283;2171.5439757650834;2173.217641649005;2190.178682993869;2193.3748881568754;2077.8441616878717;2108.926187583435;2112.4718820294925;2115.7672656007826;2127.191667166482;2126.6916297136904;2128.404046866872;2130.233116078203;2137.2305969850995;2138.9572208555896;2082.323244945399;2134.1356750516065;2137.593857167133;2138.240924471821;2145.549434618732;8039.598020098972;8066.395020373496;8084.797880052987;8105.75682729519;8119.3910456715985;4517.683762136652;4619.722816631013;4639.512851150615;4644.907101857944;4670.696404733681;2894.189626904449;2913.1115009921964;2943.2936095337177;2978.6425628924667;3034.073363414248;867.6052396159732;900.8153328567628;917.4862077236769;919.7930465645243;923.6351641101794;10915.672529824118;10917.617883374123;10928.398938058404;10945.890541094566;10948.069414099731;4134.069834287261;4186.895327616773;4325.718828276152;4354.629856462237;4364.301711726109;9298.814023719488;9302.674406395743;9331.440113593206;9364.578593963288;9387.765305867408;4577.404937358188;4586.059857729158;4608.216603177468;4610.654200934943;4620;3685.4840322354894;4035.556088830226;4178.6657067434535;4185.707000509935;4190.266703326905;3604.4232922732235;3612.0608641753333;3698.278835627027;3703.166787472797;3751.0622344413896;1184.0586733546852;1188.7622475504934;1203.9638810835688;1230.1819290171936;1233.0628722171034;696.905917701114;781.0549235425199;820.8932838731046;843.1315744782884;864.5201912938379;5004.174311238678;5275.60432967529;5355.250264962909;5355.571554275649;5359.732013399314;381.7537688191101;387.7379130928865;389.834320413823;394.6960840153066;395.1681710000465;3559.9288014240087;3589.533360663097;3609;3660.432632941898;3665.9633403666157;9488;9638.132568068768;9658.227341812639;9743.123118919331;9809;9278.536073196314;9690.854637180448;9704.320697551104;9727.319087663796;10064.496775161213;7209.387202087882;7341.155767086747;7470.85058298831;7505.887411688829;7519.586422746692;5377.677339359651;5511.834644960658;5512.2558454608115;5514.944850551443;5541.085720856014;9181.265498760216;9304.581293841658;9306.162445379949;9335.253179745469;9342.626294948126;8889.155530224618;9282;9544.90455095468;9546.57040433196;9558.091981261769;6785.117934668461;6825.761098361533;6844.93155068443;6891.483138764513;6920.688569014507;7615.1242607098675;7637.427192960439;7671.501352412075;7675.4243431741725;7687.769366919001;6786.253512113565;7042.859142817218;7065.82335441618;7068.540544864567;7161.283871613005;6852.143482064742;6920.7231710731;6948.5483443576;6999.1950925644205;7009.193942696451;6011.909821352596;6061.636301821904;6071.180390647206;6081.452669259611;6094.512439004958;4614;4779.880502987453;4789.2222510942875;4799.448063472745;4875.366202393666;4761.071591039852;4778.235482322812;4809.470958194665;4857.6599638025;4862.173430516891 09:00:51 INFO - PROCESS | 29998 | |4;prototype.html;297.11756084429237;303.72057706909646;309.70577950946597;313.437379903074;313.7129526483268;4964.677295975759;4993.800247990085;5102.596785883884;5164.896702065961;5189.091908915939;4985.1774457214515;5011.799528018875;5014.272930425086;5042.344495215617;5079.212722028092;3945.4081887716784;3956.4460975463458;3968.305546529346;3978.9110716873656;3984.8406063757416;3903.7703123516003;3967.3057214987407;3974.8608798692053;4000.0799816042327;4001.4397984282223;3915.727388598717;3920.4315374270714;3922.686185105199;3924.941125883114;3934.5081864766903;3905.7070719695853;3913.0804260998643;3920.2159568086354;3921.490206273195;3938.7439816411843;3466.4973578830927;3486.7210623150086;3487.023633382657;3491.2144767427126;3498.1079824644553;4947.653664243504;4987.127252730757;4991.650584459089;5011.599072074226;5035.899282014376;4531.954680453219;4555.316702494619;4564.307058835303;4566.680332376735;4570.223062079454;5314.840554783363;5326.866828329284;5352.759125839347;5384.488473595002;5395.81114660985;3521.517330282145;3738.532683414573;3753.935335565428;3757.7369584129124;3793.6016718244464;5488.4785945335125;5533.750981205855;5535.972320138414;5554.333479982428;5562.582806289504;3766.60450652683;3785.1294202333615;3788.9390970528298;3803.1823158021157;3806.923861522754;3623.3659109655705;3842.1739326045035;3850.1914597934187;3854.325493038707;3867.361885288896;4396.175587131369;4416.580424859633;4422.071365013319;4430;4441.822327106879;5304.177852432879;5320.547753440924;5326.7869285228935;5348.759305831247;5356.419856142447;1252.8997680185564;1279.4242590834162;1311.8097875807955;1315.3226088564397;1320.1221187909932;852.8379607874484;885.8361203177433;908.1917093786535;912.5072460871188;913.5797533134833;4616.746078965689;4617.607503362185;4635.745034023161;4649.767811529948;4667.766611669403;5423.810166644149;5457.45425457459;5462.481064298885;5502.009638265151;5503.972480137573;4466.4640243171025;4579.313103034505;4624.445066591963;4632.814687412466;4669.976650116796;2511.6483692283095;2573.4338445541953;2578.8395222150107;2581.3675649466;2593.23499567628;4489.438820147481;4512.818462983589;4518.932216016762;4524.524924882906;4542.704724192917;4701.717896926195;4863.927041094386;4868.464468908417;4874.000829829947;4898.828541001048;4496.460424748986;4503.347014682852;4505.234110201208;4523.625096824194;4530.88672783183;4785.545373189541;4817.494163112823;4821.300911367902;4849.733264670477;4859.951400486091;4504.9099018020115;4673.509281525527;4703.435587729357;4731.881702957454;4739.336492891067;4538.704984176018;4540.318952157203;4565.360849481009;4573.611243044378;4601.516840731675;3491.6033586565577;3493.1965647900615;3500.76179533925;3504.807235602066;3508.193115583379;4804.468715494039;4813.614910807197;4833.2025215840395;4847.442544107473;5175.456577059505;5198.2202669599865;5272.86817829542;5292.7353632319;5299.205119232146;5319;5266.262723218676;5285.947140528546;5313.840584782462;5349.839504814861;5351.117065684119;5102.846914592568;5189.818356357509;5200.947990520046;5234.979179060199;5272.78908843642;5323.866903327448;5329.54698850602;5348.625596208228;5350.411454740053;5365.785368585213;5251.422343542131;5258.055488926214;5264.473552644705;5284.577233821362;5302.2046692996355 09:00:51 INFO - PROCESS | 29998 | |5;yui.html;622.5642298622315;675.554134271381;720.6756959368286;725.7568714480647;726.415235735233;12238.265704057752;13174.077814552986;13523.256220907871;13562.389692463827;13580.932095339509;12765;13187.076904616657;13284.867151328484;13290.534831280907;13294.468221271138;623.8533944523033;762.7787941496973;767.9731209407672;790.284792263;791.426215993403;788.5190034079236;791.7664289034719;791.7743443118712;792.3304807437706;793.3137835772073;829.4276948905266;830.5598033042497;831.1231650608605;831.4927893984665;831.995840020799;818.300353198019;821.2854816309818;821.3757544266341;821.708293555788;823.259066839843;597.9730912108965;598.5480961873801;604.6493034040246;605.025908287661;605.1044454207753;13250.536231231958;13258.403371848193;13301.268430236332;13317.933410332984;13326.133801302884;12502.49990000399;12766.361681915867;12958;12982.740345193044;13195;10260.076593106656;10362.740931476697;10441.164706823436;10609.946950265277;10657.040866321991;3257.446234140202;3278.934421311584;3292.423825830494;3336.215989242526;3361.1429085583263;59586.70206648982;59617;59729;59964.80070398611;60454.69772651108;10113.342632728849;10314.452832075249;10384.896151038392;10461.529231184615;10552.103071238877;19894.70157947632;19932.103055362542;20123.295684650966;20130.899345503472;20143.294984675467;6842.213145488233;6843.965780171067;6844.076049733322;6852.588844669336;6906.412954898889;3580.122869896892;3640;3676.3198808220563;3684.410494320896;3741.0460332615553;2702.7297270273207;2776.8889244429997;2799.4261176458776;2807.522721137371;2811.761000314996;478.93294938708607;492.71339347675365;497.6715367857197;498.12081675842165;506.3796848860117;506.95944324453956;527.860117068977;585.3239508367842;603.2037710222552;609.4332270987935;7655.311022008046;7887.566183859828;8004;8013.198680132056;8121.147279535682;574.4255744255744;576.2566289486599;590.8375196820823;596.9015112506474;604.320139842677;3418.538497302832;3473.565804274466;3718.4980027695915;3833.9041523962123;3837.328467518173;60114.69942650346;60653;60656.090158647654;83619;96342.51828740811;87215.56392218125;87448;88190;88963.55518222367;89129.55435222782;77453;79571.20428795638;80506;80646.59676701696;82972.58513707513;7200.171980222132;7309.122905251404;7362.705491780269;7477.813054673677;7522.473426860286;46603;47141.764291178326;47179.76410117927;47619;49068.82914952269;61965.69017154886;67079;69938;69943.30056699572;70184.64907675429;9321.44071355721;9403.81192376135;9500.287478439006;9504;9580.856287155559;10178.541965611417;10302.793944120926;10325.845112323172;10367.066963973279;10457.633982810565;9416.293777966817;9470.242380609672;9576.425414475154;9665.226781857575;9725.0761177688;9271.953640231755;9285.860712089188;9301.72094837156;9472.147506724428;9607.711768646952;9133.40632858862;9381.202597779265;9398.624055037722;9401.200897923753;9627;8504.23461888433;8850.424722393023;8988;9002.594883230402;9063.456192628464;8142.837143256983;8254.669813207645;8265.917340826514;8267.112853682196;8514.659413623633 09:00:51 INFO - PROCESS | 29998 | __end_tp_report 09:00:51 INFO - PROCESS | 29998 | __start_cc_report 09:00:51 INFO - PROCESS | 29998 | _x_x_mozilla_cycle_collect,408 09:00:51 INFO - PROCESS | 29998 | __end_cc_report 09:00:51 INFO - PROCESS | 29998 | __startTimestamp1468857651568__endTimestamp 09:00:51 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | ------- Summary: start ------- 09:00:51 INFO - PROCESS | 29998 | Number of tests: 6 09:00:51 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | [#0] dojo.html Cycles:165 Average:4764.73 Median:4925.68 stddev:596.93 (12.1%) stddev-sans-first:575.35 09:00:51 INFO - PROCESS | 29998 | Values: 2654.7 2703.7 2718.0 2718.0 2727.8 4794.4 4880.0 4881.2 4907.1 5002.1 4676.5 4806.1 4809.4 4868.3 4935.4 4387.6 4411.1 4531.2 4539.5 4540.3 566.4 4339.0 4382.3 4412.9 4429.3 4463.0 4467.8 4482.6 4514.4 4525.3 4463.0 4463.6 4465.8 4479.2 4505.2 4332.2 4375.2 4383.5 4410.7 4475.2 4801.0 4807.3 4820.2 4836.7 4923.7 5169.0 5192.7 5210.1 5211.7 5220.5 5126.3 5203.5 5229.6 5234.9 5235.5 4793.9 4828.7 4830.7 4839.0 4875.1 5146.5 5246.1 5299.1 5310.9 5324.4 5085.8 5109.4 5128.2 5130.4 5138.1 5164.6 5179.3 5181.2 5205.3 5209.5 4974.0 5064.6 5092.5 5112.3 5114.6 5094.0 5102.7 5108.8 5117.9 5160.5 4403.5 4404.4 4410.5 4451.2 4474.1 3754.0 3840.6 3841.6 3847.1 3858.7 4381.7 4471.1 4490.8 4502.1 4522.9 5274.6 5287.1 5289.8 5296.2 5334.1 4360.0 4491.3 4530.8 4537.7 4556.1 4735.6 4758.7 4761.4 4761.9 4789.9 4878.6 4940.4 4942.8 4942.9 4993.4 5124.4 5171.5 5188.5 5211.3 5254.2 4861.0 4863.1 4868.4 4879.9 4920.5 5005.1 5113.3 5129.9 5151.5 5157.0 5085.8 5109.8 5111.3 5125.6 5166.2 4977.4 4990.7 4991.5 4996.5 5041.0 4902.1 4965.6 4984.9 4987.4 5029.4 4883.2 4896.7 4913.5 4925.7 4959.3 5071.1 5077.4 5079.0 5091.2 5092.3 4944.3 5004.2 5029.2 5043.9 5066.6 09:00:51 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | [#1] ext.html Cycles:180 Average:49214.81 Median:37387.88 stddev:92816.76 (248.3%) stddev-sans-first:93005.25 09:00:51 INFO - PROCESS | 29998 | Values: 561.3 565.0 575.9 577.0 600.1 33588.3 38293.6 38565.4 38573.6 38593.0 30623.2 30909.7 30927.4 31135.2 31150.7 7723.4 7809.2 7868.8 7871.2 7874.6 7632.0 7689.5 7694.2 7720.9 7741.1 7712.2 7751.3 7767.0 7777.5 7779.1 7665.7 7705.2 7751.5 7754.5 7766.0 7649.0 7651.8 7725.7 7731.1 7731.7 38008.0 38063.0 38400.0 38422.8 38450.0 2982.3 3002.0 3024.2 3132.3 3293.2 29331.0 29517.0 29585.9 29795.6 30248.5 3168.1 3210.4 3219.4 3245.0 3276.0 249640.0 252508.0 253623.0 253784.0 254188.0 53968.7 54601.5 54707.5 54767.5 54874.7 33366.3 34219.8 34460.3 36470.5 36555.3 13738.7 13931.8 13962.7 14048.9 14074.9 10974.2 11271.5 11293.1 11307.8 11307.8 18485.8 18560.3 18567.6 18654.2 18672.3 6950.8 6983.4 7040.4 7094.7 7097.9 824.6 914.8 940.2 1001.3 1019.1 27814.6 28047.9 28080.0 28470.4 28490.4 954.0 966.4 981.5 982.3 1077.7 14776.6 15030.8 15116.2 15169.8 15284.6 400192.0 403646.0 408154.0 408925.0 410294.0 52452.2 52652.5 52693.2 52906.7 53016.2 1182.8 1187.8 1192.6 1196.7 1196.7 26961.7 26967.5 28041.3 28252.6 28315.9 43939.1 44386.1 44480.8 44502.8 44570.0 368489.0 376554.0 376767.0 379027.0 379736.0 25910.0 26017.2 26251.7 26307.9 26311.9 42813.0 43883.6 44146.6 44224.8 44643.0 37193.6 38260.0 38301.4 38512.8 38980.8 37242.4 37422.1 38046.2 38305.4 38553.8 36205.5 36890.3 37105.6 37353.6 37569.0 32082.5 33819.5 33863.7 33979.0 34062.0 25781.5 25955.0 26198.5 26203.3 26533.9 09:00:51 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | [#2] jquery.html Cycles:180 Average:24124.10 Median:4995.71 stddev:65328.20 (1307.7%) stddev-sans-first:65487.10 09:00:51 INFO - PROCESS | 29998 | Values: 365.0 367.3 378.3 383.6 393.6 16387.7 16819.4 17452.6 17566.8 17649.3 15783.3 16260.3 17201.5 17212.6 17225.8 4914.7 5073.1 5076.8 5092.4 5109.5 4972.0 4984.6 5006.9 5043.0 5082.9 4958.4 5047.5 5050.9 5087.8 5093.7 5017.7 5023.7 5086.0 5092.2 5098.8 4459.0 4480.8 4491.4 4492.2 4495.8 20117.6 20263.4 20653.8 20812.9 20829.0 1697.5 1786.2 1806.8 1844.7 1967.5 5251.6 7578.9 9209.6 9643.2 9669.2 1775.7 1782.6 1825.4 1839.0 1868.0 68267.0 70308.6 70576.0 71597.3 72697.3 9363.7 9504.9 9724.3 9729.0 9768.5 12889.5 12895.9 12950.4 12968.8 13024.5 6959.6 7022.4 7239.3 7387.2 7398.9 7098.3 7104.2 7113.6 7235.2 7255.0 3958.8 3961.2 3979.8 4095.8 4149.6 1634.3 1671.7 1674.8 1699.5 1709.8 856.4 864.0 902.8 923.3 955.5 16369.5 16939.0 17799.1 17957.6 18075.9 819.9 869.2 905.5 926.4 930.6 9754.4 9915.4 9925.7 9963.3 10097.6 378882.0 388355.0 393743.0 407226.0 412814.0 49304.5 49495.2 49570.3 81587.6 85278.0 915.6 916.6 936.6 947.8 949.6 15471.6 15709.8 15944.7 15969.8 15974.3 38052.6 38416.0 38793.4 39238.8 39463.2 51123.0 55237.7 55590.7 55713.0 55774.4 7052.3 7145.4 7224.5 7490.4 7578.1 10437.8 11154.3 11280.1 11380.6 11617.4 9736.5 9805.6 9853.9 10171.7 10185.3 9844.8 9903.5 9919.5 10080.6 10138.6 9755.7 9808.2 9854.4 9989.2 10016.8 7111.8 7180.0 7194.5 7262.6 7326.3 8132.8 9613.2 10000.9 10015.6 10312.9 09:00:51 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | [#3] mootools.html Cycles:180 Average:5212.20 Median:4939.77 stddev:2979.21 (60.3%) stddev-sans-first:2973.40 09:00:51 INFO - PROCESS | 29998 | Values: 1346.3 1388.5 1464.3 1667.3 1703.9 6875.7 7512.9 7698.8 8044.3 8093.5 7757.5 7897.9 8075.9 8078.2 8085.6 2162.1 2191.2 2192.4 2195.8 2200.5 2153.2 2171.5 2173.2 2190.2 2193.4 2077.8 2108.9 2112.5 2115.8 2127.2 2126.7 2128.4 2130.2 2137.2 2139.0 2082.3 2134.1 2137.6 2138.2 2145.5 8039.6 8066.4 8084.8 8105.8 8119.4 4517.7 4619.7 4639.5 4644.9 4670.7 2894.2 2913.1 2943.3 2978.6 3034.1 867.6 900.8 917.5 919.8 923.6 10915.7 10917.6 10928.4 10945.9 10948.1 4134.1 4186.9 4325.7 4354.6 4364.3 9298.8 9302.7 9331.4 9364.6 9387.8 4577.4 4586.1 4608.2 4610.7 4620.0 3685.5 4035.6 4178.7 4185.7 4190.3 3604.4 3612.1 3698.3 3703.2 3751.1 1184.1 1188.8 1204.0 1230.2 1233.1 696.9 781.1 820.9 843.1 864.5 5004.2 5275.6 5355.3 5355.6 5359.7 381.8 387.7 389.8 394.7 395.2 3559.9 3589.5 3609.0 3660.4 3666.0 9488.0 9638.1 9658.2 9743.1 9809.0 9278.5 9690.9 9704.3 9727.3 10064.5 7209.4 7341.2 7470.9 7505.9 7519.6 5377.7 5511.8 5512.3 5514.9 5541.1 9181.3 9304.6 9306.2 9335.3 9342.6 8889.2 9282.0 9544.9 9546.6 9558.1 6785.1 6825.8 6844.9 6891.5 6920.7 7615.1 7637.4 7671.5 7675.4 7687.8 6786.3 7042.9 7065.8 7068.5 7161.3 6852.1 6920.7 6948.5 6999.2 7009.2 6011.9 6061.6 6071.2 6081.5 6094.5 4614.0 4779.9 4789.2 4799.4 4875.4 4761.1 4778.2 4809.5 4857.7 4862.2 09:00:51 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | [#4] prototype.html Cycles:180 Average:4260.60 Median:4628.63 stddev:1242.51 (26.8%) stddev-sans-first:1209.86 09:00:51 INFO - PROCESS | 29998 | Values: 297.1 303.7 309.7 313.4 313.7 4964.7 4993.8 5102.6 5164.9 5189.1 4985.2 5011.8 5014.3 5042.3 5079.2 3945.4 3956.4 3968.3 3978.9 3984.8 3903.8 3967.3 3974.9 4000.1 4001.4 3915.7 3920.4 3922.7 3924.9 3934.5 3905.7 3913.1 3920.2 3921.5 3938.7 3466.5 3486.7 3487.0 3491.2 3498.1 4947.7 4987.1 4991.7 5011.6 5035.9 4532.0 4555.3 4564.3 4566.7 4570.2 5314.8 5326.9 5352.8 5384.5 5395.8 3521.5 3738.5 3753.9 3757.7 3793.6 5488.5 5533.8 5536.0 5554.3 5562.6 3766.6 3785.1 3788.9 3803.2 3806.9 3623.4 3842.2 3850.2 3854.3 3867.4 4396.2 4416.6 4422.1 4430.0 4441.8 5304.2 5320.5 5326.8 5348.8 5356.4 1252.9 1279.4 1311.8 1315.3 1320.1 852.8 885.8 908.2 912.5 913.6 4616.7 4617.6 4635.7 4649.8 4667.8 5423.8 5457.5 5462.5 5502.0 5504.0 4466.5 4579.3 4624.4 4632.8 4670.0 2511.6 2573.4 2578.8 2581.4 2593.2 4489.4 4512.8 4518.9 4524.5 4542.7 4701.7 4863.9 4868.5 4874.0 4898.8 4496.5 4503.3 4505.2 4523.6 4530.9 4785.5 4817.5 4821.3 4849.7 4860.0 4504.9 4673.5 4703.4 4731.9 4739.3 4538.7 4540.3 4565.4 4573.6 4601.5 3491.6 3493.2 3500.8 3504.8 3508.2 4804.5 4813.6 4833.2 4847.4 5175.5 5198.2 5272.9 5292.7 5299.2 5319.0 5266.3 5285.9 5313.8 5349.8 5351.1 5102.8 5189.8 5200.9 5235.0 5272.8 5323.9 5329.5 5348.6 5350.4 5365.8 5251.4 5258.1 5264.5 5284.6 5302.2 09:00:51 INFO - PROCESS | 29998 | 09:00:51 INFO - PROCESS | 29998 | [#5] yui.html Cycles:180 Average:17121.03 Median:60654.55 stddev:24622.02 (40.6%) stddev-sans-first:24659.93 09:00:51 INFO - PROCESS | 29998 | Values: 622.6 675.6 720.7 725.8 726.4 12238.3 13174.1 13523.3 13562.4 13580.9 12765.0 13187.1 13284.9 13290.5 13294.5 623.9 762.8 768.0 790.3 791.4 788.5 791.8 791.8 792.3 793.3 829.4 830.6 831.1 831.5 832.0 818.3 821.3 821.4 821.7 823.3 598.0 598.5 604.6 605.0 605.1 13250.5 13258.4 13301.3 13317.9 13326.1 12502.5 12766.4 12958.0 12982.7 13195.0 10260.1 10362.7 10441.2 10609.9 10657.0 3257.4 3278.9 3292.4 3336.2 3361.1 59586.7 59617.0 59729.0 59964.8 60454.7 10113.3 10314.5 10384.9 10461.5 10552.1 19894.7 19932.1 20123.3 20130.9 20143.3 6842.2 6844.0 6844.1 6852.6 6906.4 3580.1 3640.0 3676.3 3684.4 3741.0 2702.7 2776.9 2799.4 2807.5 2811.8 478.9 492.7 497.7 498.1 506.4 507.0 527.9 585.3 603.2 609.4 7655.3 7887.6 8004.0 8013.2 8121.1 574.4 576.3 590.8 596.9 604.3 3418.5 3473.6 3718.5 3833.9 3837.3 60114.7 60653.0 60656.1 83619.0 96342.5 87215.6 87448.0 88190.0 88963.6 89129.6 77453.0 79571.2 80506.0 80646.6 82972.6 7200.2 7309.1 7362.7 7477.8 7522.5 46603.0 47141.8 47179.8 47619.0 49068.8 61965.7 67079.0 69938.0 69943.3 70184.6 9321.4 9403.8 9500.3 9504.0 9580.9 10178.5 10302.8 10325.8 10367.1 10457.6 9416.3 9470.2 9576.4 9665.2 9725.1 9272.0 9285.9 9301.7 9472.1 9607.7 9133.4 9381.2 9398.6 9401.2 9627.0 8504.2 8850.4 8988.0 9002.6 9063.5 8142.8 8254.7 8265.9 8267.1 8514.7 09:00:51 INFO - PROCESS | 29998 | -------- Summary: end -------- 09:00:51 INFO - PROCESS | 29998 | 09:00:52 INFO - TEST-INFO | 29998: exit 0 09:00:52 INFO - TEST-OK | dromaeo_css | took 1117816ms 09:00:52 INFO - TEST-START | kraken 09:00:52 INFO - operating with platform_type : linux_ 09:00:52 INFO - Initialising browser for kraken test... 09:00:52 INFO - TEST-INFO | started process 30241 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpqnnXTw/profile http://localhost:34594/getInfo.html) 09:00:55 INFO - PROCESS | 30241 | JavaScript error: , line 0: uncaught exception: undefined 09:00:57 INFO - PROCESS | 30241 | __metrics Screen width/height:1600/1200 09:00:57 INFO - PROCESS | 30241 | colorDepth:24 09:00:57 INFO - PROCESS | 30241 | Browser inner width/height: 1024/697 09:00:57 INFO - PROCESS | 30241 | __metrics 09:00:57 ERROR - PROCESS | 30241 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 09:00:58 INFO - TEST-INFO | 30241: exit 0 09:00:58 INFO - Browser initialized. 09:00:58 INFO - Running cycle 1/1 for kraken test... 09:00:58 INFO - TEST-INFO | started process 30360 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpqnnXTw/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:01:10 INFO - PROCESS | 30360 | RSS: Main: 169922560 09:01:10 INFO - PROCESS | 30360 | 09:01:13 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:34594/tests/kraken/driver.html?testName=audio-beat-detection) 09:01:14 INFO - PROCESS | 30360 | RSS: Main: 175071232 09:01:14 INFO - PROCESS | 30360 | 09:01:16 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:34594/tests/kraken/driver.html?testName=audio-dft) 09:01:17 INFO - PROCESS | 30360 | RSS: Main: 174936064 09:01:17 INFO - PROCESS | 30360 | 09:01:20 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:34594/tests/kraken/driver.html?testName=audio-fft) 09:01:21 INFO - PROCESS | 30360 | RSS: Main: 169271296 09:01:21 INFO - PROCESS | 30360 | 09:01:23 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:34594/tests/kraken/driver.html?testName=audio-oscillator) 09:01:23 INFO - PROCESS | 30360 | RSS: Main: 170455040 09:01:23 INFO - PROCESS | 30360 | 09:01:26 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:34594/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:01:26 INFO - PROCESS | 30360 | RSS: Main: 170393600 09:01:26 INFO - PROCESS | 30360 | 09:01:29 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:34594/tests/kraken/driver.html?testName=imaging-darkroom) 09:01:30 INFO - PROCESS | 30360 | RSS: Main: 170663936 09:01:30 INFO - PROCESS | 30360 | 09:01:34 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:34594/tests/kraken/driver.html?testName=imaging-desaturate) 09:01:34 INFO - PROCESS | 30360 | RSS: Main: 168214528 09:01:34 INFO - PROCESS | 30360 | 09:01:37 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:34594/tests/kraken/driver.html?testName=json-parse-financial) 09:01:38 INFO - PROCESS | 30360 | RSS: Main: 169361408 09:01:38 INFO - PROCESS | 30360 | 09:01:39 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:34594/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:01:40 INFO - PROCESS | 30360 | RSS: Main: 169582592 09:01:40 INFO - PROCESS | 30360 | 09:01:42 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:34594/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:01:43 INFO - PROCESS | 30360 | RSS: Main: 169422848 09:01:43 INFO - PROCESS | 30360 | 09:01:45 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:34594/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:01:46 INFO - PROCESS | 30360 | RSS: Main: 169594880 09:01:46 INFO - PROCESS | 30360 | 09:01:48 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:34594/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:01:49 INFO - PROCESS | 30360 | RSS: Main: 169709568 09:01:49 INFO - PROCESS | 30360 | 09:01:52 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:34594/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:01:52 INFO - PROCESS | 30360 | RSS: Main: 170741760 09:01:52 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | Cycle 1(1): loaded http://localhost:34594/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:34594/tests/kraken/driver.html?testName=ai-astar) 09:01:54 INFO - PROCESS | 30360 | RSS: Main: 170799104 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | __start_tp_report 09:01:54 INFO - PROCESS | 30360 | _x_x_mozilla_page_load 09:01:54 INFO - PROCESS | 30360 | _x_x_mozilla_page_load_details 09:01:54 INFO - PROCESS | 30360 | |i|pagename|runs| 09:01:54 INFO - PROCESS | 30360 | |0;ai-astar;105;114;108;114;116;115;116;116;115;113 09:01:54 INFO - PROCESS | 30360 | |1;audio-beat-detection;146;121;146;175;125;145;149;125;184;127 09:01:54 INFO - PROCESS | 30360 | |2;audio-dft;163;164;168;176;163;163;161;162;164;164 09:01:54 INFO - PROCESS | 30360 | |3;audio-fft;76;77;76;148;77;75;77;77;161;77 09:01:54 INFO - PROCESS | 30360 | |4;audio-oscillator;85;85;145;86;86;84;132;86;86;138 09:01:54 INFO - PROCESS | 30360 | |5;imaging-gaussian-blur;118;118;119;117;117;118;122;117;119;117 09:01:54 INFO - PROCESS | 30360 | |6;imaging-darkroom;148;147;147;147;147;148;147;149;148;147 09:01:54 INFO - PROCESS | 30360 | |7;imaging-desaturate;96;95;96;95;95;96;95;96;96;94 09:01:54 INFO - PROCESS | 30360 | |8;json-parse-financial;65;64;64;64;65;65;64;63;63;66 09:01:54 INFO - PROCESS | 30360 | |9;json-stringify-tinderbox;64;65;65;65;65;65;65;65;66;66 09:01:54 INFO - PROCESS | 30360 | |10;stanford-crypto-aes;82;80;78;79;87;84;79;79;83;78 09:01:54 INFO - PROCESS | 30360 | |11;stanford-crypto-ccm;133;142;134;130;142;140;130;144;175;130 09:01:54 INFO - PROCESS | 30360 | |12;stanford-crypto-pbkdf2;166;164;164;166;164;163;165;165;170;164 09:01:54 INFO - PROCESS | 30360 | |13;stanford-crypto-sha256-iterative;67;68;75;67;67;66;67;67;70;68 09:01:54 INFO - PROCESS | 30360 | __end_tp_report 09:01:54 INFO - PROCESS | 30360 | __start_cc_report 09:01:54 INFO - PROCESS | 30360 | _x_x_mozilla_cycle_collect,1018 09:01:54 INFO - PROCESS | 30360 | __end_cc_report 09:01:54 INFO - PROCESS | 30360 | __startTimestamp1468857714978__endTimestamp 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | ------- Summary: start ------- 09:01:54 INFO - PROCESS | 30360 | Number of tests: 14 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#0] ai-astar Cycles:10 Average:113.20 Median:115.00 stddev:3.74 (3.2%) stddev-sans-first:2.52 09:01:54 INFO - PROCESS | 30360 | Values: 105.0 114.0 108.0 114.0 116.0 115.0 116.0 116.0 115.0 113.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#1] audio-beat-detection Cycles:10 Average:144.30 Median:146.00 stddev:21.43 (14.7%) stddev-sans-first:22.72 09:01:54 INFO - PROCESS | 30360 | Values: 146.0 121.0 146.0 175.0 125.0 145.0 149.0 125.0 184.0 127.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#2] audio-dft Cycles:10 Average:164.80 Median:164.00 stddev:4.34 (2.6%) stddev-sans-first:4.56 09:01:54 INFO - PROCESS | 30360 | Values: 163.0 164.0 168.0 176.0 163.0 163.0 161.0 162.0 164.0 164.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#3] audio-fft Cycles:10 Average:92.10 Median:77.00 stddev:33.04 (42.9%) stddev-sans-first:34.52 09:01:54 INFO - PROCESS | 30360 | Values: 76.0 77.0 76.0 148.0 77.0 75.0 77.0 77.0 161.0 77.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#4] audio-oscillator Cycles:10 Average:101.30 Median:85.50 stddev:25.75 (30.1%) stddev-sans-first:26.62 09:01:54 INFO - PROCESS | 30360 | Values: 85.0 85.0 145.0 86.0 86.0 84.0 132.0 86.0 86.0 138.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#5] imaging-gaussian-blur Cycles:10 Average:118.20 Median:118.00 stddev:1.55 (1.3%) stddev-sans-first:1.64 09:01:54 INFO - PROCESS | 30360 | Values: 118.0 118.0 119.0 117.0 117.0 118.0 122.0 117.0 119.0 117.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#6] imaging-darkroom Cycles:10 Average:147.50 Median:147.50 stddev:0.71 (0.5%) stddev-sans-first:0.73 09:01:54 INFO - PROCESS | 30360 | Values: 148.0 147.0 147.0 147.0 147.0 148.0 147.0 149.0 148.0 147.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#7] imaging-desaturate Cycles:10 Average:95.40 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.71 09:01:54 INFO - PROCESS | 30360 | Values: 96.0 95.0 96.0 95.0 95.0 96.0 95.0 96.0 96.0 94.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#8] json-parse-financial Cycles:10 Average:64.30 Median:64.50 stddev:0.95 (1.5%) stddev-sans-first:0.97 09:01:54 INFO - PROCESS | 30360 | Values: 65.0 64.0 64.0 64.0 65.0 65.0 64.0 63.0 63.0 66.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#9] json-stringify-tinderbox Cycles:10 Average:65.10 Median:65.00 stddev:0.57 (0.9%) stddev-sans-first:0.44 09:01:54 INFO - PROCESS | 30360 | Values: 64.0 65.0 65.0 65.0 65.0 65.0 65.0 65.0 66.0 66.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#10] stanford-crypto-aes Cycles:10 Average:80.90 Median:81.00 stddev:3.00 (3.7%) stddev-sans-first:3.15 09:01:54 INFO - PROCESS | 30360 | Values: 82.0 80.0 78.0 79.0 87.0 84.0 79.0 79.0 83.0 78.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#11] stanford-crypto-ccm Cycles:10 Average:140.00 Median:141.00 stddev:13.47 (9.6%) stddev-sans-first:14.05 09:01:54 INFO - PROCESS | 30360 | Values: 133.0 142.0 134.0 130.0 142.0 140.0 130.0 144.0 175.0 130.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:165.10 Median:165.00 stddev:1.97 (1.2%) stddev-sans-first:2.06 09:01:54 INFO - PROCESS | 30360 | Values: 166.0 164.0 164.0 166.0 164.0 163.0 165.0 165.0 170.0 164.0 09:01:54 INFO - PROCESS | 30360 | 09:01:54 INFO - PROCESS | 30360 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.20 Median:67.50 stddev:2.62 (3.9%) stddev-sans-first:2.74 09:01:54 INFO - PROCESS | 30360 | Values: 67.0 68.0 75.0 67.0 67.0 66.0 67.0 67.0 70.0 68.0 09:01:54 INFO - PROCESS | 30360 | -------- Summary: end -------- 09:01:54 INFO - PROCESS | 30360 | 09:01:55 INFO - TEST-INFO | 30360: exit 0 09:01:56 INFO - TEST-OK | kraken | took 63635ms 09:01:56 INFO - SUITE-END | took 1181s 09:01:56 INFO - Completed test suite (00:19:41) 09:01:56 INFO - javascript benchmark 09:01:56 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6353.090084026441, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2654.694710108338, 2703.7161098084707, 2717.95923061154, 2718.021512255588, 2727.83632982021, 4794.400699912511, 4879.951200487994, 4881.194602890523, 4907.0676571451395, 5002.124628190061, 4676.462206846214, 4806.134895718769, 4809.398825146856, 4868.294097355882, 4935.407751069876, 4387.583179597933, 4411.113378154436, 4531.161735079005, 4539.523350048247, 4540.250858608326, 566.3512188653278, 4339.023719663082, 4382.298832186851, 4412.933805992912, 4429.335599660045, 4463.040446304028, 4467.776611169428, 4482.551744825524, 4514.413126293561, 4525.32120181972, 4462.955370446286, 4463.620592249663, 4465.754383508905, 4479.216137175981, 4505.166544189336, 4332.155229730204, 4375.234333991539, 4383.517813040563, 4410.735355878625, 4475.2168370535355, 4801.0, 4807.326974223612, 4820.204666230068, 4836.685615435021, 4923.655344125877, 5169.043726910533, 5192.662476938987, 5210.062188806013, 5211.7133557654315, 5220.530152286275, 5126.282320475137, 5203.505666961632, 5229.633925625208, 5234.947650523484, 5235.528802407764, 4793.880152996203, 4828.686135401188, 4830.7101573905675, 4839.032193561302, 4875.07373599015, 5146.511081447256, 5246.055709972242, 5299.12564426873, 5310.893782124336, 5324.387695415076, 5085.796568137307, 5109.4379618241965, 5128.153854614022, 5130.410002849645, 5138.126518491866, 5164.561012313995, 5179.2749015137915, 5181.196914478187, 5205.349331333583, 5209.531142197145, 4973.9554693514765, 5064.594832413398, 5092.541671249605, 5112.309838171799, 5114.616403769732, 5093.974530127326, 5102.668326558762, 5108.846734597968, 5117.948820511821, 5160.535551800356, 4403.515613282536, 4404.383386325917, 4410.514843367227, 4451.221036318631, 4474.082813023322, 3753.9812300938866, 3840.558335791364, 3841.5774264830848, 3847.1343947611563, 3858.7298889078056, 4381.7370957742, 4471.06107717383, 4490.797914093873, 4502.077074199781, 4522.886927826765, 5274.551663108602, 5287.127623942083, 5289.841304760864, 5296.152615581488, 5334.146536554133, 4360.040791025969, 4491.326301054803, 4530.796114174804, 4537.705049171794, 4556.066006468666, 4735.59747421473, 4758.690685105457, 4761.35721677576, 4761.928571071437, 4789.928151077736, 4878.634102442402, 4940.431850337113, 4942.8022879085875, 4942.8517144484285, 4993.425756038102, 5124.436312005751, 5171.50870667286, 5188.507091826271, 5211.296474975981, 5254.15933450646, 4861.0, 4863.051704917649, 4868.391451068616, 4879.902401952012, 4920.483349248278, 5005.074061298671, 5113.258577506315, 5129.8974020518635, 5151.5363617274625, 5156.9742151289, 5085.7711402986215, 5109.821156259513, 5111.258867464123, 5125.589952803842, 5166.173412254021, 4977.427595826382, 4990.6506544541535, 4991.450940396626, 4996.525330093636, 5040.974795126001, 4902.14212512816, 4965.577925876341, 4984.925226121539, 4987.351644286365, 5029.44676085623, 4883.243097319921, 4896.6572339935865, 4913.484084171254, 4925.679830810986, 4959.280904268933, 5071.112555302733, 5077.365329333833, 5078.97460512695, 5091.210862316347, 5092.287079808756, 4944.332515110414, 5004.2493625956395, 5029.245613157909, 5043.940772437829, 5066.59467242627], "value": 4728.532398063556, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [561.2619405481792, 565.0225110558731, 575.8790653962668, 576.9567282453817, 600.1148306248288, 33588.32823343531, 38293.617063829355, 38565.421518677205, 38573.61426385735, 38593.0, 30623.23441913953, 30909.690903090963, 30927.381452370995, 31135.221619459524, 31150.688493115118, 7723.382129429646, 7809.219078092174, 7868.803279917991, 7871.212878712112, 7874.606269686521, 7631.961840190791, 7689.538627682357, 7694.230576942317, 7720.884186737204, 7741.071071471403, 7712.15166331703, 7751.341136003446, 7767.0, 7777.5333479991095, 7779.105402878657, 7665.731699390494, 7705.190954949734, 7751.457397982143, 7754.495957762728, 7766.0, 7648.961755191244, 7651.808704782369, 7725.729599463992, 7731.110922243957, 7731.690732370698, 38008.0, 38063.0, 38400.0, 38422.80788596039, 38450.0, 2982.2693440107314, 3001.969980300191, 3024.1683537027275, 3132.342208136294, 3293.226091868409, 29331.0, 29517.0, 29585.852070739507, 29795.55306670402, 30248.54627180594, 3168.1287645897332, 3210.4060748761553, 3219.404410184123, 3244.967550324514, 3276.025986372993, 249640.0, 252508.0, 253623.0, 253784.0, 254188.0, 53968.73015634897, 54601.45398546043, 54707.45292547103, 54767.45232547703, 54874.72562637241, 33366.3326733464, 34219.828900855835, 34460.31079378398, 36470.45294320587, 36555.26889462196, 13738.65653358654, 13931.791023134661, 13962.650933726534, 14048.929755351157, 14074.859251407559, 10974.176936729777, 11271.49278282463, 11293.096552275798, 11307.830382544269, 11307.830382544269, 18485.81514184841, 18560.25758969653, 18567.628647426976, 18654.16056277471, 18672.253109875724, 6950.79147625572, 6983.406410455168, 7040.3663670269925, 7094.68073936674, 7097.858042839114, 824.5629816197305, 914.8353296406577, 940.1961323068814, 1001.3040936549029, 1019.0624625344701, 27814.582781258297, 28047.859760701067, 28080.0, 28470.430591388056, 28490.430191396055, 954.0459540459541, 966.3622009473854, 981.4798156976814, 982.2780256511459, 1077.7197928538637, 14776.63058423548, 15030.774538381933, 15116.209832681607, 15169.848301517064, 15284.617884552976, 400192.0, 403646.0, 408154.0, 408925.0, 410294.0, 52452.21321680178, 52652.47347526552, 52693.209601856004, 52906.735466322425, 53016.20475692867, 1182.781185480689, 1187.8337032815414, 1192.5706745571588, 1196.6529706385224, 1196.6948428150765, 26961.73038269592, 26967.460650787267, 28041.298967525974, 28252.576211356434, 28315.858420708588, 43939.12121757483, 44386.11227775491, 44480.777596113105, 44502.77748611236, 44570.0, 368489.0, 376554.0, 376767.0, 379027.0, 379736.0, 25910.0, 26017.219483415527, 26251.73748262493, 26307.868460657573, 26311.868440657676, 42813.0, 43883.561164389226, 44146.558534414246, 44224.7788761067, 44643.0, 37193.628063719014, 38260.0, 38301.42547861728, 38512.80743596264, 38980.80509597434, 37242.44136337903, 37422.12631819661, 38046.239075218895, 38305.425418618186, 38553.80723096366, 36205.45691814572, 36890.26219475649, 37105.628943711294, 37353.6264637361, 37569.0, 32082.51876221812, 33819.4927076099, 33863.661363386054, 33979.0, 34062.0, 25781.484370312864, 25955.0, 26198.476030479665, 26203.344916377242, 26533.867330663223], "value": 17471.509352272693, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [364.99999999999994, 367.27463260061376, 378.292592851368, 383.63937898375525, 393.5867339293741, 16387.672246555063, 16819.41132060378, 17452.56368590786, 17566.824331756678, 17649.294028238855, 15783.28975196116, 16260.349586016575, 17201.483955481322, 17212.569685757862, 17225.82774172258, 4914.705117692941, 5073.061483625541, 5076.771545280453, 5092.439831618519, 5109.514596113363, 4971.975140124295, 4984.551390374865, 5006.874828129289, 5042.974785126069, 5082.949170508303, 4958.429780575226, 5047.47001564834, 5050.873728156789, 5087.84736457905, 5093.745312734367, 5017.724025178613, 5023.673461225008, 5086.0, 5092.210707340369, 5098.821541246057, 4459.0413061192, 4480.843170489017, 4491.4161159049445, 4492.213862574069, 4495.797689103998, 20117.597648047104, 20263.392098237076, 20653.79346206549, 20812.895935520377, 20829.0, 1697.4822679082874, 1786.178357955342, 1806.7560879281261, 1844.6587381334496, 1967.4884530022298, 5251.6061295403, 7578.886316705254, 9209.631614735403, 9643.180329671986, 9669.17811985982, 1775.6626241014294, 1782.5632719983687, 1825.3520000399799, 1838.9816101838944, 1867.953301167468, 68267.0, 70308.6484567574, 70576.0, 71597.28402715958, 72697.27302726958, 9363.719088427359, 9504.904950950402, 9724.319297649097, 9728.951355243178, 9768.51157442125, 12889.48442062307, 12895.935520322339, 12950.417231224617, 12968.8054679178, 13024.54414095502, 6959.617221052789, 7022.438204943593, 7239.348458638748, 7387.150477695026, 7398.926010739824, 7098.3256590623805, 7104.21853596104, 7113.608751518716, 7235.240299768554, 7255.0, 3958.8218530166214, 3961.2275606256503, 3979.801009949491, 4095.774732389747, 4149.605787450248, 1634.2890842483557, 1671.690737213595, 1674.7990241171137, 1699.4646686293777, 1709.8290170982802, 856.4090777363599, 864.0, 902.8374892519279, 923.2660035271975, 955.5031383680447, 16369.525167884787, 16939.0, 17799.110044497982, 17957.640847183244, 18075.909620451814, 819.8893149424752, 869.2437579305918, 905.4567259644292, 926.4117285523606, 930.5672862119147, 9754.414735115915, 9915.405075695482, 9925.702228933143, 9963.252756043326, 10097.646582369582, 378882.0, 388355.0, 393743.0, 407226.0, 412814.0, 49304.506954929995, 49495.20607645374, 49570.25644615333, 81587.59206203932, 85278.0, 915.6337465014047, 916.5875356089653, 936.6347124621403, 947.8056998315467, 949.5632009275672, 15471.613209669847, 15709.764353534934, 15944.681106377575, 15969.840301596836, 15974.322696117206, 38052.61947380491, 38416.0, 38793.418098729104, 39238.80380598079, 39463.21073578455, 51123.0, 55237.72381138069, 55590.72204638951, 55713.0, 55774.44225557693, 7052.259512751088, 7145.428365730625, 7224.494285399972, 7490.400767938443, 7578.09062912454, 10437.843432348369, 11154.274972126786, 11280.09759219244, 11380.601678941197, 11617.419129043683, 9736.464494452874, 9805.558749856416, 9853.852192216978, 10171.7457063574, 10185.287029908131, 9844.753881153028, 9903.50482475859, 9919.454430006419, 10080.64717734905, 10138.594456221963, 9755.658551950648, 9808.215342772419, 9854.408735475894, 9989.150922171697, 10016.799664006825, 7111.7866464006165, 7179.964100179465, 7194.532355396883, 7262.636868156465, 7326.267373262631, 8132.837343252983, 9613.230941524522, 10000.949995249977, 10015.649452269136, 10312.948435258077], "value": 8003.637121768483, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1346.347021694478, 1388.5348408283226, 1464.319091622396, 1667.2747354900612, 1703.889247198932, 6875.7249710011665, 7512.924870751291, 7698.7690369288875, 8044.276015158634, 8093.473924194931, 7757.495762775416, 7897.881531777028, 8075.878861817077, 8078.151794061627, 8085.555294458803, 2162.0811155258993, 2191.2111639809655, 2192.3970908000347, 2195.7913998170147, 2200.526886719355, 2153.2033147735283, 2171.5439757650834, 2173.217641649005, 2190.178682993869, 2193.3748881568754, 2077.8441616878717, 2108.926187583435, 2112.4718820294925, 2115.7672656007826, 2127.191667166482, 2126.6916297136904, 2128.404046866872, 2130.233116078203, 2137.2305969850995, 2138.9572208555896, 2082.323244945399, 2134.1356750516065, 2137.593857167133, 2138.240924471821, 2145.549434618732, 8039.598020098972, 8066.395020373496, 8084.797880052987, 8105.75682729519, 8119.3910456715985, 4517.683762136652, 4619.722816631013, 4639.512851150615, 4644.907101857944, 4670.696404733681, 2894.189626904449, 2913.1115009921964, 2943.2936095337177, 2978.6425628924667, 3034.073363414248, 867.6052396159732, 900.8153328567628, 917.4862077236769, 919.7930465645243, 923.6351641101794, 10915.672529824118, 10917.617883374123, 10928.398938058404, 10945.890541094566, 10948.069414099731, 4134.069834287261, 4186.895327616773, 4325.718828276152, 4354.629856462237, 4364.301711726109, 9298.814023719488, 9302.674406395743, 9331.440113593206, 9364.578593963288, 9387.765305867408, 4577.404937358188, 4586.059857729158, 4608.216603177468, 4610.654200934943, 4620.0, 3685.4840322354894, 4035.556088830226, 4178.6657067434535, 4185.707000509935, 4190.266703326905, 3604.4232922732235, 3612.0608641753333, 3698.278835627027, 3703.166787472797, 3751.0622344413896, 1184.0586733546852, 1188.7622475504934, 1203.9638810835688, 1230.1819290171936, 1233.0628722171034, 696.905917701114, 781.0549235425199, 820.8932838731046, 843.1315744782884, 864.5201912938379, 5004.174311238678, 5275.60432967529, 5355.250264962909, 5355.571554275649, 5359.732013399314, 381.7537688191101, 387.7379130928865, 389.834320413823, 394.6960840153066, 395.1681710000465, 3559.9288014240087, 3589.533360663097, 3609.0, 3660.432632941898, 3665.9633403666157, 9488.0, 9638.132568068768, 9658.227341812639, 9743.123118919331, 9809.0, 9278.536073196314, 9690.854637180448, 9704.320697551104, 9727.319087663796, 10064.496775161213, 7209.387202087882, 7341.155767086747, 7470.85058298831, 7505.887411688829, 7519.586422746692, 5377.677339359651, 5511.834644960658, 5512.2558454608115, 5514.944850551443, 5541.085720856014, 9181.265498760216, 9304.581293841658, 9306.162445379949, 9335.253179745469, 9342.626294948126, 8889.155530224618, 9282.0, 9544.90455095468, 9546.57040433196, 9558.091981261769, 6785.117934668461, 6825.761098361533, 6844.93155068443, 6891.483138764513, 6920.688569014507, 7615.1242607098675, 7637.427192960439, 7671.501352412075, 7675.4243431741725, 7687.769366919001, 6786.253512113565, 7042.859142817218, 7065.82335441618, 7068.540544864567, 7161.283871613005, 6852.143482064742, 6920.7231710731, 6948.5483443576, 6999.1950925644205, 7009.193942696451, 6011.909821352596, 6061.636301821904, 6071.180390647206, 6081.452669259611, 6094.512439004958, 4614.0, 4779.880502987453, 4789.2222510942875, 4799.448063472745, 4875.366202393666, 4761.071591039852, 4778.235482322812, 4809.470958194665, 4857.6599638025, 4862.173430516891], "value": 4092.32938511826, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [297.11756084429237, 303.72057706909646, 309.70577950946597, 313.437379903074, 313.7129526483268, 4964.677295975759, 4993.800247990085, 5102.596785883884, 5164.896702065961, 5189.091908915939, 4985.1774457214515, 5011.799528018875, 5014.272930425086, 5042.344495215617, 5079.212722028092, 3945.4081887716784, 3956.4460975463458, 3968.305546529346, 3978.9110716873656, 3984.8406063757416, 3903.7703123516003, 3967.3057214987407, 3974.8608798692053, 4000.0799816042327, 4001.4397984282223, 3915.727388598717, 3920.4315374270714, 3922.686185105199, 3924.941125883114, 3934.5081864766903, 3905.7070719695853, 3913.0804260998643, 3920.2159568086354, 3921.490206273195, 3938.7439816411843, 3466.4973578830927, 3486.7210623150086, 3487.023633382657, 3491.2144767427126, 3498.1079824644553, 4947.653664243504, 4987.127252730757, 4991.650584459089, 5011.599072074226, 5035.899282014376, 4531.954680453219, 4555.316702494619, 4564.307058835303, 4566.680332376735, 4570.223062079454, 5314.840554783363, 5326.866828329284, 5352.759125839347, 5384.488473595002, 5395.81114660985, 3521.517330282145, 3738.532683414573, 3753.935335565428, 3757.7369584129124, 3793.6016718244464, 5488.4785945335125, 5533.750981205855, 5535.972320138414, 5554.333479982428, 5562.582806289504, 3766.60450652683, 3785.1294202333615, 3788.9390970528298, 3803.1823158021157, 3806.923861522754, 3623.3659109655705, 3842.1739326045035, 3850.1914597934187, 3854.325493038707, 3867.361885288896, 4396.175587131369, 4416.580424859633, 4422.071365013319, 4430.0, 4441.822327106879, 5304.177852432879, 5320.547753440924, 5326.7869285228935, 5348.759305831247, 5356.419856142447, 1252.8997680185564, 1279.4242590834162, 1311.8097875807955, 1315.3226088564397, 1320.1221187909932, 852.8379607874484, 885.8361203177433, 908.1917093786535, 912.5072460871188, 913.5797533134833, 4616.746078965689, 4617.607503362185, 4635.745034023161, 4649.767811529948, 4667.766611669403, 5423.810166644149, 5457.45425457459, 5462.481064298885, 5502.009638265151, 5503.972480137573, 4466.4640243171025, 4579.313103034505, 4624.445066591963, 4632.814687412466, 4669.976650116796, 2511.6483692283095, 2573.4338445541953, 2578.8395222150107, 2581.3675649466, 2593.23499567628, 4489.438820147481, 4512.818462983589, 4518.932216016762, 4524.524924882906, 4542.704724192917, 4701.717896926195, 4863.927041094386, 4868.464468908417, 4874.000829829947, 4898.828541001048, 4496.460424748986, 4503.347014682852, 4505.234110201208, 4523.625096824194, 4530.88672783183, 4785.545373189541, 4817.494163112823, 4821.300911367902, 4849.733264670477, 4859.951400486091, 4504.9099018020115, 4673.509281525527, 4703.435587729357, 4731.881702957454, 4739.336492891067, 4538.704984176018, 4540.318952157203, 4565.360849481009, 4573.611243044378, 4601.516840731675, 3491.6033586565577, 3493.1965647900615, 3500.76179533925, 3504.807235602066, 3508.193115583379, 4804.468715494039, 4813.614910807197, 4833.2025215840395, 4847.442544107473, 5175.456577059505, 5198.2202669599865, 5272.86817829542, 5292.7353632319, 5299.205119232146, 5319.0, 5266.262723218676, 5285.947140528546, 5313.840584782462, 5349.839504814861, 5351.117065684119, 5102.846914592568, 5189.818356357509, 5200.947990520046, 5234.979179060199, 5272.78908843642, 5323.866903327448, 5329.54698850602, 5348.625596208228, 5350.411454740053, 5365.785368585213, 5251.422343542131, 5258.055488926214, 5264.473552644705, 5284.577233821362, 5302.2046692996355], "value": 3867.6065134466685, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [622.5642298622315, 675.554134271381, 720.6756959368286, 725.7568714480647, 726.415235735233, 12238.265704057752, 13174.077814552986, 13523.256220907871, 13562.389692463827, 13580.932095339509, 12765.0, 13187.076904616657, 13284.867151328484, 13290.534831280907, 13294.468221271138, 623.8533944523033, 762.7787941496973, 767.9731209407672, 790.284792263, 791.426215993403, 788.5190034079236, 791.7664289034719, 791.7743443118712, 792.3304807437706, 793.3137835772073, 829.4276948905266, 830.5598033042497, 831.1231650608605, 831.4927893984665, 831.995840020799, 818.300353198019, 821.2854816309818, 821.3757544266341, 821.708293555788, 823.259066839843, 597.9730912108965, 598.5480961873801, 604.6493034040246, 605.025908287661, 605.1044454207753, 13250.536231231958, 13258.403371848193, 13301.268430236332, 13317.933410332984, 13326.133801302884, 12502.49990000399, 12766.361681915867, 12958.0, 12982.740345193044, 13195.0, 10260.076593106656, 10362.740931476697, 10441.164706823436, 10609.946950265277, 10657.040866321991, 3257.446234140202, 3278.934421311584, 3292.423825830494, 3336.215989242526, 3361.1429085583263, 59586.70206648982, 59617.0, 59729.0, 59964.80070398611, 60454.69772651108, 10113.342632728849, 10314.452832075249, 10384.896151038392, 10461.529231184615, 10552.103071238877, 19894.70157947632, 19932.103055362542, 20123.295684650966, 20130.899345503472, 20143.294984675467, 6842.213145488233, 6843.965780171067, 6844.076049733322, 6852.588844669336, 6906.412954898889, 3580.122869896892, 3640.0, 3676.3198808220563, 3684.410494320896, 3741.0460332615553, 2702.7297270273207, 2776.8889244429997, 2799.4261176458776, 2807.522721137371, 2811.761000314996, 478.93294938708607, 492.71339347675365, 497.6715367857197, 498.12081675842165, 506.3796848860117, 506.95944324453956, 527.860117068977, 585.3239508367842, 603.2037710222552, 609.4332270987935, 7655.311022008046, 7887.566183859828, 8004.0, 8013.198680132056, 8121.147279535682, 574.4255744255744, 576.2566289486599, 590.8375196820823, 596.9015112506474, 604.320139842677, 3418.538497302832, 3473.565804274466, 3718.4980027695915, 3833.9041523962123, 3837.328467518173, 60114.69942650346, 60653.0, 60656.090158647654, 83619.0, 96342.51828740811, 87215.56392218125, 87448.0, 88190.0, 88963.55518222367, 89129.55435222782, 77453.0, 79571.20428795638, 80506.0, 80646.59676701696, 82972.58513707513, 7200.171980222132, 7309.122905251404, 7362.705491780269, 7477.813054673677, 7522.473426860286, 46603.0, 47141.764291178326, 47179.76410117927, 47619.0, 49068.82914952269, 61965.69017154886, 67079.0, 69938.0, 69943.30056699572, 70184.64907675429, 9321.44071355721, 9403.81192376135, 9500.287478439006, 9504.0, 9580.856287155559, 10178.541965611417, 10302.793944120926, 10325.845112323172, 10367.066963973279, 10457.633982810565, 9416.293777966817, 9470.242380609672, 9576.425414475154, 9665.226781857575, 9725.0761177688, 9271.953640231755, 9285.860712089188, 9301.72094837156, 9472.147506724428, 9607.711768646952, 9133.40632858862, 9381.202597779265, 9398.624055037722, 9401.200897923753, 9627.0, 8504.23461888433, 8850.424722393023, 8988.0, 9002.594883230402, 9063.456192628464, 8142.837143256983, 8254.669813207645, 8265.917340826514, 8267.112853682196, 8514.659413623633], "value": 6282.0977901692395, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1560.3999999999999, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 114.0, 108.0, 114.0, 116.0, 115.0, 116.0, 116.0, 115.0, 113.0], "value": 113.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 121.0, 146.0, 175.0, 125.0, 145.0, 149.0, 125.0, 184.0, 127.0], "value": 144.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 168.0, 176.0, 163.0, 163.0, 161.0, 162.0, 164.0, 164.0], "value": 164.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 76.0, 148.0, 77.0, 75.0, 77.0, 77.0, 161.0, 77.0], "value": 92.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 145.0, 86.0, 86.0, 84.0, 132.0, 86.0, 86.0, 138.0], "value": 101.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 119.0, 117.0, 117.0, 118.0, 122.0, 117.0, 119.0, 117.0], "value": 118.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 147.0, 147.0, 147.0, 148.0, 147.0, 149.0, 148.0, 147.0], "value": 147.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 96.0, 95.0, 95.0, 96.0, 95.0, 96.0, 96.0, 94.0], "value": 95.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 64.0, 64.0, 65.0, 65.0, 64.0, 63.0, 63.0, 66.0], "value": 64.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 65.0, 65.0, 65.0, 65.0, 65.0, 65.0, 65.0, 66.0, 66.0], "value": 65.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 80.0, 78.0, 79.0, 87.0, 84.0, 79.0, 79.0, 83.0, 78.0], "value": 80.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 142.0, 134.0, 130.0, 142.0, 140.0, 130.0, 144.0, 175.0, 130.0], "value": 140.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 164.0, 164.0, 166.0, 164.0, 163.0, 165.0, 165.0, 170.0, 164.0], "value": 165.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 68.0, 75.0, 67.0, 67.0, 66.0, 67.0, 67.0, 70.0, 68.0], "value": 68.2, "unit": "score"}]}]} 09:01:56 INFO - Return code: 0 09:01:56 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:01:56 ERROR - # TBPL SUCCESS # 09:01:56 INFO - Running post-action listener: _resource_record_post_action 09:01:56 INFO - ##### 09:01:56 INFO - ##### Finished run-tests step (success) 09:01:56 INFO - ##### 09:01:56 INFO - Running post-run listener: _resource_record_post_run 09:01:56 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 0; Write bytes: 535670784; Read time: 0; Write time: 484828 09:01:56 INFO - TinderboxPrint: CPU usage
13.4% 09:01:56 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 09:01:56 INFO - TinderboxPrint: I/O write bytes / time
535,670,784 / 484,828 09:01:56 INFO - TinderboxPrint: CPU idle
8,279.8 (86.6%) 09:01:56 INFO - TinderboxPrint: CPU user
1,225.4 (12.8%) 09:01:56 INFO - TinderboxPrint: Swap in / out
0 / 0 09:01:56 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 246968320; Read time: 0; Write time: 296208 09:01:56 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 0; Write bytes: 288702464; Read time: 0; Write time: 188620 09:01:56 INFO - Running post-run listener: _upload_blobber_files 09:01:56 INFO - Blob upload gear active. 09:01:56 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:01:56 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 09:01:56 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', 'Autoland-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:01:56 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 Autoland-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:01:57 INFO - (blobuploader) - INFO - Open directory for files ... 09:01:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 09:01:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:01:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:01:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 09:01:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:01:58 INFO - (blobuploader) - INFO - Done attempting. 09:01:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:01:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:01:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:02:02 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:02:02 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:02:02 INFO - (blobuploader) - INFO - Done attempting. 09:02:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 09:02:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:02:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:02:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 09:02:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:02:03 INFO - (blobuploader) - INFO - Done attempting. 09:02:03 INFO - (blobuploader) - INFO - Iteration through files over. 09:02:03 INFO - Return code: 0 09:02:03 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:02:03 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:02:03 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/d353f135a46c9140e8ab244457b9baafb9b85548df41673255b676e40d71d144a1ad4c6c6800dc5a7122ac935bb665364e6fd987f0346722ce8272911a47f720", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/72be660687f97b125a493deb74db669e57ca76ba3bf16a94a52ad694cdae99e2c1a30611cf049c85a9b264c036c39754d8c8f5381da7bb8d4c7ba1bee83acba1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/b93422d3d89a43060e300f40838abd75bab7e9a19fa0901f925b8a6f0b7531a602d24ad53f4a98a01bca97591e5274d0a010bf40b460fbaa30eb30c443ae2df0"} 09:02:03 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:02:03 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:02:03 INFO - Contents: 09:02:03 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/d353f135a46c9140e8ab244457b9baafb9b85548df41673255b676e40d71d144a1ad4c6c6800dc5a7122ac935bb665364e6fd987f0346722ce8272911a47f720", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/72be660687f97b125a493deb74db669e57ca76ba3bf16a94a52ad694cdae99e2c1a30611cf049c85a9b264c036c39754d8c8f5381da7bb8d4c7ba1bee83acba1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/b93422d3d89a43060e300f40838abd75bab7e9a19fa0901f925b8a6f0b7531a602d24ad53f4a98a01bca97591e5274d0a010bf40b460fbaa30eb30c443ae2df0"} 09:02:03 INFO - Running post-run listener: copy_logs_to_upload_dir 09:02:03 INFO - Copying logs to upload dir... 09:02:03 INFO - mkdir: /builds/slave/test/build/upload/logs 09:02:03 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1247.179455 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 47 secs) (at 2016-07-18 09:02:03.202644) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-18 09:02:03.206474) ========= 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=826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616 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/Autoland-Non-PGO/sha512/d353f135a46c9140e8ab244457b9baafb9b85548df41673255b676e40d71d144a1ad4c6c6800dc5a7122ac935bb665364e6fd987f0346722ce8272911a47f720", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/72be660687f97b125a493deb74db669e57ca76ba3bf16a94a52ad694cdae99e2c1a30611cf049c85a9b264c036c39754d8c8f5381da7bb8d4c7ba1bee83acba1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/b93422d3d89a43060e300f40838abd75bab7e9a19fa0901f925b8a6f0b7531a602d24ad53f4a98a01bca97591e5274d0a010bf40b460fbaa30eb30c443ae2df0"} build_url:https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011419 build_url: 'https://queue.taskcluster.net/v1/task/QbqGuDgsQAunnCVQHgzRgA/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/Autoland-Non-PGO/sha512/d353f135a46c9140e8ab244457b9baafb9b85548df41673255b676e40d71d144a1ad4c6c6800dc5a7122ac935bb665364e6fd987f0346722ce8272911a47f720", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/72be660687f97b125a493deb74db669e57ca76ba3bf16a94a52ad694cdae99e2c1a30611cf049c85a9b264c036c39754d8c8f5381da7bb8d4c7ba1bee83acba1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/b93422d3d89a43060e300f40838abd75bab7e9a19fa0901f925b8a6f0b7531a602d24ad53f4a98a01bca97591e5274d0a010bf40b460fbaa30eb30c443ae2df0"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-18 09:02:03.232315) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 09:02:03.232683) ========= 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=826874ccc97bd7bf541b4875000001d5-1468855589.371887-189692616 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004471 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 09:02:03.317661) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-18 09:02:03.318038) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-18 09:02:03.318359) ========= ========= Total master_lag: 0.16 =========