builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-013 starttime: 1468608956.67 results: success (0) buildid: 20160715064309 builduid: c7b7f5c4fe1d41f4b73d9e5baffa9038 revision: 5a9c26f8bb9d599e80c92f6a7f30ad91bd54a854 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.669674) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.670145) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.670430) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.686068) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.686459) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-15 11:55:56-- 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% 223M=0s 2016-07-15 11:55:56 (223 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.085426 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.786084) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.786543) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018945 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.835998) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:56.836353) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 5a9c26f8bb9d599e80c92f6a7f30ad91bd54a854 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 5a9c26f8bb9d599e80c92f6a7f30ad91bd54a854 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-15 11:55:57,001 truncating revision to first 12 chars 2016-07-15 11:55:57,001 Setting DEBUG logging. 2016-07-15 11:55:57,001 attempt 1/10 2016-07-15 11:55:57,001 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/5a9c26f8bb9d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-15 11:55:57,304 unpacking tar archive at: mozilla-inbound-5a9c26f8bb9d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.617104 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:57.468090) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:57.468410) ========= script_repo_revision: 5a9c26f8bb9d599e80c92f6a7f30ad91bd54a854 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:57.468802) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:57.469060) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-15 11:55:57.478447) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 28 secs) (at 2016-07-15 11:55:57.478831) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:55:57 INFO - MultiFileLogger online at 20160715 11:55:57 in /builds/slave/test 11:55:57 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 11:55:57 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:55:57 INFO - {'append_to_log': False, 11:55:57 INFO - 'base_work_dir': '/builds/slave/test', 11:55:57 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 11:55:57 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:55:57 INFO - 'branch': 'Mozilla-Inbound', 11:55:57 INFO - 'buildbot_json_path': 'buildprops.json', 11:55:57 INFO - 'config_files': ('talos/linux_config.py',), 11:55:57 INFO - 'default_actions': ('clobber', 11:55:57 INFO - 'read-buildbot-config', 11:55:57 INFO - 'download-and-extract', 11:55:57 INFO - 'populate-webroot', 11:55:57 INFO - 'create-virtualenv', 11:55:57 INFO - 'install', 11:55:57 INFO - 'run-tests'), 11:55:57 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:55:57 INFO - 'download_minidump_stackwalk': True, 11:55:57 INFO - 'download_symbols': 'ondemand', 11:55:57 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:55:57 INFO - 'tooltool.py': '/tools/tooltool.py', 11:55:57 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:55:57 INFO - '/tools/misc-python/virtualenv.py')}, 11:55:57 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:55:57 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:55:57 INFO - 'installer_path': 'installer.exe', 11:55:57 INFO - 'log_level': 'info', 11:55:57 INFO - 'log_name': 'talos', 11:55:57 INFO - 'log_to_console': True, 11:55:57 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:55:57 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:55:57 INFO - 'opt_config_files': (), 11:55:57 INFO - 'pip_index': False, 11:55:57 INFO - 'sps_profile': False, 11:55:57 INFO - 'sps_profile_interval': 0, 11:55:57 INFO - 'suite': 'dromaeojs-e10s', 11:55:57 INFO - 'system_bits': '32', 11:55:57 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:55:57 INFO - 'title': 'talos-linux64-ix-013', 11:55:57 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:55:57 INFO - 'use_talos_json': True, 11:55:57 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:55:57 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:55:57 INFO - 'work_dir': 'build'} 11:55:57 INFO - ##### 11:55:57 INFO - ##### Running clobber step. 11:55:57 INFO - ##### 11:55:57 INFO - Running pre-action listener: _resource_record_pre_action 11:55:57 INFO - Running main action method: clobber 11:55:57 INFO - rmtree: /builds/slave/test/build 11:55:57 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:55:58 INFO - Running post-action listener: _resource_record_post_action 11:55:58 INFO - ##### 11:55:58 INFO - ##### Finished clobber step (success) 11:55:58 INFO - ##### 11:55:58 INFO - ##### 11:55:58 INFO - ##### Running read-buildbot-config step. 11:55:58 INFO - ##### 11:55:58 INFO - Running pre-action listener: _resource_record_pre_action 11:55:58 INFO - Running main action method: read_buildbot_config 11:55:58 INFO - Using buildbot properties: 11:55:58 INFO - { 11:55:58 INFO - "project": "", 11:55:58 INFO - "product": "firefox", 11:55:58 INFO - "script_repo_revision": "production", 11:55:58 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 11:55:58 INFO - "repository": "", 11:55:58 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 11:55:58 INFO - "buildid": "20160715064309", 11:55:58 INFO - "pgo_build": "True", 11:55:58 INFO - "basedir": "/builds/slave/test", 11:55:58 INFO - "buildnumber": 832, 11:55:58 INFO - "slavename": "talos-linux64-ix-013", 11:55:58 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 11:55:58 INFO - "platform": "ubuntu64_hw", 11:55:58 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 11:55:58 INFO - "branch": "mozilla-inbound", 11:55:58 INFO - "repo_path": "integration/mozilla-inbound", 11:55:58 INFO - "revision": "5a9c26f8bb9d599e80c92f6a7f30ad91bd54a854", 11:55:58 INFO - "stage_platform": "linux64-pgo", 11:55:58 INFO - "builduid": "c7b7f5c4fe1d41f4b73d9e5baffa9038", 11:55:58 INFO - "slavebuilddir": "test" 11:55:58 INFO - } 11:55:58 INFO - Found installer url https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 11:55:58 INFO - Running post-action listener: _resource_record_post_action 11:55:58 INFO - ##### 11:55:58 INFO - ##### Finished read-buildbot-config step (success) 11:55:58 INFO - ##### 11:55:58 INFO - ##### 11:55:58 INFO - ##### Running download-and-extract step. 11:55:58 INFO - ##### 11:55:58 INFO - Running pre-action listener: _resource_record_pre_action 11:55:58 INFO - Running main action method: download_and_extract 11:55:58 INFO - mkdir: /builds/slave/test/build/tests 11:55:58 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')]} 11:55:58 INFO - https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:55:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:55:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:55:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:55:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:55:59 INFO - Downloaded 1361 bytes. 11:55:59 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:55:59 INFO - Using the following test package requirements: 11:55:59 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:55:59 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:55:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:55:59 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:55:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:55:59 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:55:59 INFO - u'jsshell-linux-x86_64.zip'], 11:55:59 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:55:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:55:59 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:55:59 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:55:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:55:59 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:55:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:55:59 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:55:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:55:59 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:55:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:55:59 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:55:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:55:59 INFO - https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:55:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:55:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:55:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:55:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:56:00 INFO - Downloaded 24327512 bytes. 11:56:00 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'] 11:56:00 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 11:56:01 INFO - Return code: 0 11:56:01 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 11:56:01 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')]} 11:56:01 INFO - https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:56:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:56:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:56:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:56:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:56:02 INFO - Downloaded 24327512 bytes. 11:56:02 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'] 11:56:02 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 11:56:04 INFO - Return code: 0 11:56:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:04 INFO - https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:56:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:56:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:56:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:56:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:56:05 INFO - Downloaded 14403317 bytes. 11:56:05 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'] 11:56:05 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 11:56:05 INFO - Return code: 0 11:56:05 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')]} 11:56:05 INFO - https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:56:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:56:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:56:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:56:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/B888eZ8qRBWKmMbDJFEmLw/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 11:56:07 INFO - Downloaded 60817707 bytes. 11:56:07 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:56:07 INFO - mkdir: /builds/slave/test/properties 11:56:07 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:56:07 INFO - Writing to file /builds/slave/test/properties/build_url 11:56:07 INFO - Contents: 11:56:07 INFO - build_url:https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:56:07 INFO - Running post-action listener: _resource_record_post_action 11:56:07 INFO - Running post-action listener: set_extra_try_arguments 11:56:07 INFO - ##### 11:56:07 INFO - ##### Finished download-and-extract step (success) 11:56:07 INFO - ##### 11:56:07 INFO - ##### 11:56:07 INFO - ##### Running populate-webroot step. 11:56:07 INFO - ##### 11:56:07 INFO - Running pre-action listener: _resource_record_pre_action 11:56:07 INFO - Running main action method: populate_webroot 11:56:07 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:56:07 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:56:07 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:56:07 INFO - '--tppagecycles', 11:56:07 INFO - '7'], 11:56:07 INFO - 'tests': ['tsvgm']}}, 11:56:07 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:56:07 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:56:07 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:56:07 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:56:07 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:56:07 INFO - 'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:56:07 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:56:07 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:56:07 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:56:07 INFO - 'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['damp', 'tps']}, 11:56:07 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:56:07 INFO - 'tests': ['damp', 'tps']}, 11:56:07 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['dromaeo_dom']}, 11:56:07 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:56:07 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['basic_compositor_video']}, 11:56:07 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 11:56:07 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['a11yr', 11:56:07 INFO - 'ts_paint', 11:56:07 INFO - 'tpaint', 11:56:07 INFO - 'sessionrestore', 11:56:07 INFO - 'sessionrestore_no_auto_restore', 11:56:07 INFO - 'tabpaint']}, 11:56:07 INFO - 'other-e10s': {'tests': ['a11yr', 11:56:07 INFO - 'ts_paint', 11:56:07 INFO - 'tpaint', 11:56:07 INFO - 'sessionrestore', 11:56:07 INFO - 'sessionrestore_no_auto_restore', 11:56:07 INFO - 'tabpaint']}, 11:56:07 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:56:07 INFO - 'ts_paint', 11:56:07 INFO - 'tpaint', 11:56:07 INFO - 'sessionrestore', 11:56:07 INFO - 'sessionrestore_no_auto_restore', 11:56:07 INFO - 'tabpaint']}, 11:56:07 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:56:07 INFO - 'ts_paint', 11:56:07 INFO - 'tpaint', 11:56:07 INFO - 'sessionrestore', 11:56:07 INFO - 'sessionrestore_no_auto_restore', 11:56:07 INFO - 'tabpaint']}, 11:56:07 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['a11yr', 11:56:07 INFO - 'ts_paint', 11:56:07 INFO - 'tpaint', 11:56:07 INFO - 'sessionrestore', 11:56:07 INFO - 'sessionrestore_no_auto_restore', 11:56:07 INFO - 'tabpaint']}, 11:56:07 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['a11yr', 11:56:07 INFO - 'ts_paint', 11:56:07 INFO - 'tpaint', 11:56:07 INFO - 'sessionrestore', 11:56:07 INFO - 'sessionrestore_no_auto_restore', 11:56:07 INFO - 'tabpaint']}, 11:56:07 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['tsvgx', 11:56:07 INFO - 'tsvgr_opacity', 11:56:07 INFO - 'tart', 11:56:07 INFO - 'tscrollx', 11:56:07 INFO - 'cart']}, 11:56:07 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:56:07 INFO - 'tsvgr_opacity', 11:56:07 INFO - 'tart', 11:56:07 INFO - 'tscrollx', 11:56:07 INFO - 'cart']}, 11:56:07 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:56:07 INFO - 'talos_options': ['--disable-e10s'], 11:56:07 INFO - 'tests': ['tp5o']}, 11:56:07 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:56:07 INFO - 'tests': ['tp5o']}, 11:56:07 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:56:07 INFO - 'talos_options': ['--disable-e10s', 11:56:07 INFO - '--xperf_path', 11:56:07 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:56:07 INFO - 'tests': ['tp5n']}, 11:56:07 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:56:07 INFO - 'talos_options': ['--xperf_path', 11:56:07 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:56:07 INFO - 'tests': ['tp5n']}}, 11:56:07 INFO - 'talos.zip': {'path': '', 11:56:07 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:56:07 INFO - Running post-action listener: _resource_record_post_action 11:56:07 INFO - ##### 11:56:07 INFO - ##### Finished populate-webroot step (success) 11:56:07 INFO - ##### 11:56:07 INFO - ##### 11:56:07 INFO - ##### Running create-virtualenv step. 11:56:07 INFO - ##### 11:56:07 INFO - Running pre-action listener: _resource_record_pre_action 11:56:07 INFO - Running main action method: create_virtualenv 11:56:07 INFO - Creating virtualenv /builds/slave/test/build/venv 11:56:07 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 11:56:07 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:56:07 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:56:07 INFO - Using real prefix '/usr' 11:56:07 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:56:08 INFO - Installing distribute.............................................................................................................................................................................................done. 11:56:10 INFO - Installing pip.................done. 11:56:10 INFO - Return code: 0 11:56:10 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:56:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:10 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:10 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 11:56:10 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 11:56:10 INFO - Using env: {'DISPLAY': ':0', 11:56:10 INFO - 'HOME': '/home/cltbld', 11:56:10 INFO - 'LANG': 'en_US.UTF-8', 11:56:10 INFO - 'LANGUAGE': 'en_US:en', 11:56:10 INFO - 'LOGNAME': 'cltbld', 11:56:10 INFO - 'MAIL': '/var/mail/cltbld', 11:56:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:10 INFO - 'MOZ_NO_REMOTE': '1', 11:56:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:10 INFO - 'NO_EM_RESTART': '1', 11:56:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:10 INFO - 'PWD': '/builds/slave/test', 11:56:10 INFO - 'SHELL': '/bin/bash', 11:56:10 INFO - 'SHLVL': '1', 11:56:10 INFO - 'TERM': 'linux', 11:56:10 INFO - 'TMOUT': '86400', 11:56:10 INFO - 'USER': 'cltbld', 11:56:10 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:10 INFO - '_': '/tools/buildbot/bin/python'} 11:56:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:10 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 11:56:10 INFO - Cleaning up... 11:56:10 INFO - Return code: 0 11:56:10 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:56:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:10 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:10 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 11:56:10 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 11:56:10 INFO - Using env: {'DISPLAY': ':0', 11:56:10 INFO - 'HOME': '/home/cltbld', 11:56:10 INFO - 'LANG': 'en_US.UTF-8', 11:56:10 INFO - 'LANGUAGE': 'en_US:en', 11:56:10 INFO - 'LOGNAME': 'cltbld', 11:56:10 INFO - 'MAIL': '/var/mail/cltbld', 11:56:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:10 INFO - 'MOZ_NO_REMOTE': '1', 11:56:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:10 INFO - 'NO_EM_RESTART': '1', 11:56:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:10 INFO - 'PWD': '/builds/slave/test', 11:56:10 INFO - 'SHELL': '/bin/bash', 11:56:10 INFO - 'SHLVL': '1', 11:56:10 INFO - 'TERM': 'linux', 11:56:10 INFO - 'TMOUT': '86400', 11:56:10 INFO - 'USER': 'cltbld', 11:56:10 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:10 INFO - '_': '/tools/buildbot/bin/python'} 11:56:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:10 INFO - Downloading/unpacking psutil>=3.1.1 11:56:10 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 11:56:10 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 11:56:10 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 11:56:10 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 11:56:10 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 11:56:10 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 11:56:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:56:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:56:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:56:12 INFO - Installing collected packages: psutil 11:56:12 INFO - Running setup.py install for psutil 11:56:12 INFO - building 'psutil._psutil_linux' extension 11:56:12 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 11:56:13 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 11:56:13 INFO - building 'psutil._psutil_posix' extension 11:56:13 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 11:56:13 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 11:56:13 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:56:13 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:56:13 INFO - Successfully installed psutil 11:56:13 INFO - Cleaning up... 11:56:13 INFO - Return code: 0 11:56:13 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:56:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:13 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:13 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 11:56:13 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 11:56:13 INFO - Using env: {'DISPLAY': ':0', 11:56:13 INFO - 'HOME': '/home/cltbld', 11:56:13 INFO - 'LANG': 'en_US.UTF-8', 11:56:13 INFO - 'LANGUAGE': 'en_US:en', 11:56:13 INFO - 'LOGNAME': 'cltbld', 11:56:13 INFO - 'MAIL': '/var/mail/cltbld', 11:56:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:13 INFO - 'MOZ_NO_REMOTE': '1', 11:56:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:13 INFO - 'NO_EM_RESTART': '1', 11:56:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:13 INFO - 'PWD': '/builds/slave/test', 11:56:13 INFO - 'SHELL': '/bin/bash', 11:56:13 INFO - 'SHLVL': '1', 11:56:13 INFO - 'TERM': 'linux', 11:56:13 INFO - 'TMOUT': '86400', 11:56:13 INFO - 'USER': 'cltbld', 11:56:13 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:13 INFO - '_': '/tools/buildbot/bin/python'} 11:56:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:13 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:56:13 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 11:56:13 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 11:56:13 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 11:56:13 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 11:56:13 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 11:56:13 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 11:56:15 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:56:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:56:15 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:56:15 INFO - Installing collected packages: mozsystemmonitor 11:56:15 INFO - Running setup.py install for mozsystemmonitor 11:56:15 INFO - Successfully installed mozsystemmonitor 11:56:15 INFO - Cleaning up... 11:56:15 INFO - Return code: 0 11:56:15 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:56:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:15 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:15 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 11:56:15 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 11:56:15 INFO - Using env: {'DISPLAY': ':0', 11:56:15 INFO - 'HOME': '/home/cltbld', 11:56:15 INFO - 'LANG': 'en_US.UTF-8', 11:56:15 INFO - 'LANGUAGE': 'en_US:en', 11:56:15 INFO - 'LOGNAME': 'cltbld', 11:56:15 INFO - 'MAIL': '/var/mail/cltbld', 11:56:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:15 INFO - 'MOZ_NO_REMOTE': '1', 11:56:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:15 INFO - 'NO_EM_RESTART': '1', 11:56:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:15 INFO - 'PWD': '/builds/slave/test', 11:56:15 INFO - 'SHELL': '/bin/bash', 11:56:15 INFO - 'SHLVL': '1', 11:56:15 INFO - 'TERM': 'linux', 11:56:15 INFO - 'TMOUT': '86400', 11:56:15 INFO - 'USER': 'cltbld', 11:56:15 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:15 INFO - '_': '/tools/buildbot/bin/python'} 11:56:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:15 INFO - Downloading/unpacking jsonschema==2.5.1 11:56:15 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 11:56:15 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 11:56:15 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 11:56:15 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 11:56:15 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 11:56:15 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 11:56:17 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:56:17 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:56:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:56:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:56:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:56:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:56:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:56:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:56:18 INFO - Downloading functools32-3.2.3-2.tar.gz 11:56:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:56:18 INFO - warning: no files found matching '*.txt' 11:56:18 INFO - no previously-included directories found matching 'build' 11:56:18 INFO - no previously-included directories found matching 'dist' 11:56:18 INFO - no previously-included directories found matching '.git*' 11:56:18 INFO - Installing collected packages: jsonschema, functools32 11:56:18 INFO - Running setup.py install for functools32 11:56:18 INFO - warning: no files found matching '*.txt' 11:56:18 INFO - no previously-included directories found matching 'build' 11:56:18 INFO - no previously-included directories found matching 'dist' 11:56:18 INFO - no previously-included directories found matching '.git*' 11:56:18 INFO - Successfully installed jsonschema functools32 11:56:18 INFO - Cleaning up... 11:56:18 INFO - Return code: 0 11:56:18 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:56: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')]} 11:56:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56: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')]} 11:56:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:18 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:18 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 11:56:18 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 11:56:18 INFO - Using env: {'DISPLAY': ':0', 11:56:18 INFO - 'HOME': '/home/cltbld', 11:56:18 INFO - 'LANG': 'en_US.UTF-8', 11:56:18 INFO - 'LANGUAGE': 'en_US:en', 11:56:18 INFO - 'LOGNAME': 'cltbld', 11:56:18 INFO - 'MAIL': '/var/mail/cltbld', 11:56:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:18 INFO - 'MOZ_NO_REMOTE': '1', 11:56:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:18 INFO - 'NO_EM_RESTART': '1', 11:56:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:18 INFO - 'PWD': '/builds/slave/test', 11:56:18 INFO - 'SHELL': '/bin/bash', 11:56:18 INFO - 'SHLVL': '1', 11:56:18 INFO - 'TERM': 'linux', 11:56:18 INFO - 'TMOUT': '86400', 11:56:18 INFO - 'USER': 'cltbld', 11:56:18 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:18 INFO - '_': '/tools/buildbot/bin/python'} 11:56:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:18 INFO - Downloading/unpacking blobuploader==1.2.4 11:56:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:56:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:56:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:56:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:56:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:56:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:56:20 INFO - Downloading blobuploader-1.2.4.tar.gz 11:56:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:56:20 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:56:20 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 11:56:20 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 11:56:20 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 11:56:20 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 11:56:20 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 11:56:20 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 11:56:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:56:20 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:56:20 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 11:56:20 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 11:56:20 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 11:56:20 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 11:56:20 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 11:56:20 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 11:56:21 INFO - Downloading docopt-0.6.1.tar.gz 11:56:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:56:21 INFO - Installing collected packages: blobuploader, requests, docopt 11:56:21 INFO - Running setup.py install for blobuploader 11:56:21 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:56:21 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:56:21 INFO - Running setup.py install for requests 11:56:21 INFO - Running setup.py install for docopt 11:56:21 INFO - Successfully installed blobuploader requests docopt 11:56:21 INFO - Cleaning up... 11:56:21 INFO - Return code: 0 11:56:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:56:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:56:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:21 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:21 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 11:56:21 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 11:56:21 INFO - Using env: {'DISPLAY': ':0', 11:56:21 INFO - 'HOME': '/home/cltbld', 11:56:21 INFO - 'LANG': 'en_US.UTF-8', 11:56:21 INFO - 'LANGUAGE': 'en_US:en', 11:56:21 INFO - 'LOGNAME': 'cltbld', 11:56:21 INFO - 'MAIL': '/var/mail/cltbld', 11:56:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:21 INFO - 'MOZ_NO_REMOTE': '1', 11:56:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:21 INFO - 'NO_EM_RESTART': '1', 11:56:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:21 INFO - 'PWD': '/builds/slave/test', 11:56:21 INFO - 'SHELL': '/bin/bash', 11:56:21 INFO - 'SHLVL': '1', 11:56:21 INFO - 'TERM': 'linux', 11:56:21 INFO - 'TMOUT': '86400', 11:56:21 INFO - 'USER': 'cltbld', 11:56:21 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:21 INFO - '_': '/tools/buildbot/bin/python'} 11:56:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:56:22 INFO - Running setup.py (path:/tmp/pip-kZ9qCm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:56:22 INFO - Running setup.py (path:/tmp/pip-4w0_LS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:56:22 INFO - Running setup.py (path:/tmp/pip-cGRAIA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:56:22 INFO - Running setup.py (path:/tmp/pip-IeeYyO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:56:22 INFO - Running setup.py (path:/tmp/pip-4Snk6Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:56:22 INFO - Running setup.py (path:/tmp/pip-rATp76-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:56:22 INFO - Running setup.py (path:/tmp/pip-jdeFBE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:56:22 INFO - Running setup.py (path:/tmp/pip-5e5y7H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:56:22 INFO - Running setup.py (path:/tmp/pip-799Rep-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:56:22 INFO - Running setup.py (path:/tmp/pip-dEp85G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:56:22 INFO - Running setup.py (path:/tmp/pip-_ej7Vc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:56:22 INFO - Running setup.py (path:/tmp/pip-HuIYLW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:56:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:56:22 INFO - Running setup.py (path:/tmp/pip-sw5wob-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:56:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:56:23 INFO - Running setup.py (path:/tmp/pip-GYSNLj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:56:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:56:23 INFO - Running setup.py (path:/tmp/pip-cskLUN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:56:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:56:23 INFO - Running setup.py (path:/tmp/pip-NITt0P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:56:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:56:23 INFO - Running setup.py (path:/tmp/pip-m6Zijy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:56:23 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:56:23 INFO - Running setup.py install for manifestparser 11:56:23 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:56:23 INFO - Running setup.py install for mozcrash 11:56:23 INFO - Running setup.py install for mozdebug 11:56:23 INFO - Running setup.py install for mozdevice 11:56:23 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:56:23 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:56:23 INFO - Running setup.py install for mozfile 11:56:23 INFO - Running setup.py install for mozhttpd 11:56:23 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:56:23 INFO - Running setup.py install for mozinfo 11:56:24 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Running setup.py install for mozInstall 11:56:24 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Running setup.py install for mozleak 11:56:24 INFO - Running setup.py install for mozlog 11:56:24 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Running setup.py install for moznetwork 11:56:24 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Running setup.py install for mozprocess 11:56:24 INFO - Running setup.py install for mozprofile 11:56:24 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Running setup.py install for mozrunner 11:56:24 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:56:24 INFO - Running setup.py install for mozscreenshot 11:56:24 INFO - Running setup.py install for moztest 11:56:24 INFO - Running setup.py install for mozversion 11:56:25 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:56:25 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:56:25 INFO - Cleaning up... 11:56:25 INFO - Return code: 0 11:56:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:56:25 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')]} 11:56:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:25 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')]} 11:56:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:25 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:25 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 11:56:25 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 11:56:25 INFO - Using env: {'DISPLAY': ':0', 11:56:25 INFO - 'HOME': '/home/cltbld', 11:56:25 INFO - 'LANG': 'en_US.UTF-8', 11:56:25 INFO - 'LANGUAGE': 'en_US:en', 11:56:25 INFO - 'LOGNAME': 'cltbld', 11:56:25 INFO - 'MAIL': '/var/mail/cltbld', 11:56:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:25 INFO - 'MOZ_NO_REMOTE': '1', 11:56:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:25 INFO - 'NO_EM_RESTART': '1', 11:56:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:25 INFO - 'PWD': '/builds/slave/test', 11:56:25 INFO - 'SHELL': '/bin/bash', 11:56:25 INFO - 'SHLVL': '1', 11:56:25 INFO - 'TERM': 'linux', 11:56:25 INFO - 'TMOUT': '86400', 11:56:25 INFO - 'USER': 'cltbld', 11:56:25 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:25 INFO - '_': '/tools/buildbot/bin/python'} 11:56:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:56:25 INFO - Running setup.py (path:/tmp/pip-npezUR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:56:25 INFO - Running setup.py (path:/tmp/pip-FHPuG3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:56:25 INFO - Running setup.py (path:/tmp/pip-OcZ_H8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:56:25 INFO - Running setup.py (path:/tmp/pip-jpVSw8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:56:25 INFO - Running setup.py (path:/tmp/pip-25ZXbH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:56:25 INFO - Running setup.py (path:/tmp/pip-Xs6hW1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:56:25 INFO - Running setup.py (path:/tmp/pip-MeGEiO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:56:25 INFO - Running setup.py (path:/tmp/pip-DiiaFM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:56:25 INFO - Running setup.py (path:/tmp/pip-MZQseQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:56:25 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)) 11:56:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:56:26 INFO - Running setup.py (path:/tmp/pip-NMLOYw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:56:26 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)) 11:56:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:56:26 INFO - Running setup.py (path:/tmp/pip-Bpq9Ru-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:56:26 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)) 11:56:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:56:26 INFO - Running setup.py (path:/tmp/pip-lWSKEF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:56:26 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)) 11:56:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:56:26 INFO - Running setup.py (path:/tmp/pip-GKIf8J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:56:26 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)) 11:56:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:56:26 INFO - Running setup.py (path:/tmp/pip-VzLpYY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:56:26 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)) 11:56:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:56:26 INFO - Running setup.py (path:/tmp/pip-iXjQ0g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:56:26 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)) 11:56:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:56:26 INFO - Running setup.py (path:/tmp/pip-5XJhpt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:56:26 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)) 11:56:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:56:26 INFO - Running setup.py (path:/tmp/pip-4B1vgp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:56:26 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)) 11:56:26 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)) 11:56:26 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)) 11:56:26 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)) 11:56:26 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)) 11:56:26 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)) 11:56:26 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:56:26 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 11:56:26 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 11:56:26 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 11:56:26 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 11:56:26 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 11:56:26 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 11:56:28 INFO - Downloading blessings-1.6.tar.gz 11:56:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:56:28 INFO - Installing collected packages: blessings 11:56:28 INFO - Running setup.py install for blessings 11:56:28 INFO - Successfully installed blessings 11:56:28 INFO - Cleaning up... 11:56:28 INFO - Return code: 0 11:56:28 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:56:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:56:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:56:28 INFO - Reading from file tmpfile_stdout 11:56:28 INFO - Current package versions: 11:56:28 INFO - argparse == 1.2.1 11:56:28 INFO - blessings == 1.6 11:56:28 INFO - blobuploader == 1.2.4 11:56:28 INFO - docopt == 0.6.1 11:56:28 INFO - functools32 == 3.2.3-2 11:56:28 INFO - jsonschema == 2.5.1 11:56:28 INFO - manifestparser == 1.1 11:56:28 INFO - mozInstall == 1.12 11:56:28 INFO - mozcrash == 0.17 11:56:28 INFO - mozdebug == 0.1 11:56:28 INFO - mozdevice == 0.48 11:56:28 INFO - mozfile == 1.2 11:56:28 INFO - mozhttpd == 0.7 11:56:28 INFO - mozinfo == 0.9 11:56:28 INFO - mozleak == 0.1 11:56:28 INFO - mozlog == 3.2 11:56:28 INFO - moznetwork == 0.27 11:56:28 INFO - mozprocess == 0.23 11:56:28 INFO - mozprofile == 0.28 11:56:28 INFO - mozrunner == 6.12 11:56:28 INFO - mozscreenshot == 0.1 11:56:28 INFO - mozsystemmonitor == 0.3 11:56:28 INFO - moztest == 0.7 11:56:28 INFO - mozversion == 1.4 11:56:28 INFO - psutil == 3.1.1 11:56:28 INFO - requests == 1.2.3 11:56:28 INFO - wsgiref == 0.1.2 11:56:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:56:28 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')]} 11:56:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:28 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')]} 11:56:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:28 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:28 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 11:56:28 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 11:56:28 INFO - Using env: {'DISPLAY': ':0', 11:56:28 INFO - 'HOME': '/home/cltbld', 11:56:28 INFO - 'LANG': 'en_US.UTF-8', 11:56:28 INFO - 'LANGUAGE': 'en_US:en', 11:56:28 INFO - 'LOGNAME': 'cltbld', 11:56:28 INFO - 'MAIL': '/var/mail/cltbld', 11:56:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:28 INFO - 'MOZ_NO_REMOTE': '1', 11:56:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:28 INFO - 'NO_EM_RESTART': '1', 11:56:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:28 INFO - 'PWD': '/builds/slave/test', 11:56:28 INFO - 'SHELL': '/bin/bash', 11:56:28 INFO - 'SHLVL': '1', 11:56:28 INFO - 'TERM': 'linux', 11:56:28 INFO - 'TMOUT': '86400', 11:56:28 INFO - 'USER': 'cltbld', 11:56:28 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:28 INFO - '_': '/tools/buildbot/bin/python'} 11:56:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 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)) 11:56:29 INFO - Cleaning up... 11:56:29 INFO - Return code: 0 11:56:29 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:56:29 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')]} 11:56:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:56:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:29 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')]} 11:56:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:56:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:56:29 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 0x1716030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18798a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1945400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', '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 11:56:29 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 11:56:29 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 11:56:29 INFO - Using env: {'DISPLAY': ':0', 11:56:29 INFO - 'HOME': '/home/cltbld', 11:56:29 INFO - 'LANG': 'en_US.UTF-8', 11:56:29 INFO - 'LANGUAGE': 'en_US:en', 11:56:29 INFO - 'LOGNAME': 'cltbld', 11:56:29 INFO - 'MAIL': '/var/mail/cltbld', 11:56:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:29 INFO - 'MOZ_NO_REMOTE': '1', 11:56:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:29 INFO - 'NO_EM_RESTART': '1', 11:56:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:29 INFO - 'PWD': '/builds/slave/test', 11:56:29 INFO - 'SHELL': '/bin/bash', 11:56:29 INFO - 'SHLVL': '1', 11:56:29 INFO - 'TERM': 'linux', 11:56:29 INFO - 'TMOUT': '86400', 11:56:29 INFO - 'USER': 'cltbld', 11:56:29 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:29 INFO - '_': '/tools/buildbot/bin/python'} 11:56:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:56:29 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:56:29 INFO - Cleaning up... 11:56:29 INFO - Return code: 0 11:56:29 INFO - Running post-action listener: _resource_record_post_action 11:56:29 INFO - Running post-action listener: _start_resource_monitoring 11:56:29 INFO - Starting resource monitoring. 11:56:29 INFO - ##### 11:56:29 INFO - ##### Finished create-virtualenv step (success) 11:56:29 INFO - ##### 11:56:29 INFO - ##### 11:56:29 INFO - ##### Running install step. 11:56:29 INFO - ##### 11:56:29 INFO - Running pre-action listener: _resource_record_pre_action 11:56:29 INFO - Running main action method: install 11:56:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:56:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:56:29 INFO - Reading from file tmpfile_stdout 11:56:29 INFO - Detecting whether we're running mozinstall >=1.0... 11:56:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:56:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:56:29 INFO - Reading from file tmpfile_stdout 11:56:29 INFO - Output received: 11:56:29 INFO - Usage: mozinstall [options] installer 11:56:29 INFO - Options: 11:56:29 INFO - -h, --help show this help message and exit 11:56:29 INFO - -d DEST, --destination=DEST 11:56:29 INFO - Directory to install application into. [default: 11:56:29 INFO - "/builds/slave/test"] 11:56:29 INFO - --app=APP Application being installed. [default: firefox] 11:56:29 INFO - mkdir: /builds/slave/test/build/application 11:56:29 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'] 11:56:29 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 11:56:46 INFO - Reading from file tmpfile_stdout 11:56:46 INFO - Output received: 11:56:46 INFO - /builds/slave/test/build/application/firefox/firefox 11:56:46 INFO - Running post-action listener: _resource_record_post_action 11:56:46 INFO - ##### 11:56:46 INFO - ##### Finished install step (success) 11:56:46 INFO - ##### 11:56:46 INFO - ##### 11:56:46 INFO - ##### Running run-tests step. 11:56:46 INFO - ##### 11:56:46 INFO - Running pre-action listener: _resource_record_pre_action 11:56:46 INFO - Running main action method: run_tests 11:56:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:56:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:56:46 INFO - Python 2.7.3 11:56:46 INFO - Return code: 0 11:56:46 INFO - grabbing minidump binary from tooltool 11:56: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')]} 11:56:46 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 0x19d4570>, '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 0x19d5470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19d5900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:56:46 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 11:56:46 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 11:56:46 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 11:56:46 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:56:47 INFO - Return code: 0 11:56:47 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:56:47 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:56:47 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:56:47 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:56:47 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:56:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 11:56:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-013 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 11:56:47 INFO - Using env: {'DISPLAY': ':0', 11:56:47 INFO - 'HOME': '/home/cltbld', 11:56:47 INFO - 'LANG': 'en_US.UTF-8', 11:56:47 INFO - 'LANGUAGE': 'en_US:en', 11:56:47 INFO - 'LOGNAME': 'cltbld', 11:56:47 INFO - 'MAIL': '/var/mail/cltbld', 11:56:47 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:56:47 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:56:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:56:47 INFO - 'MOZ_NO_REMOTE': '1', 11:56:47 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:56:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:56:47 INFO - 'NO_EM_RESTART': '1', 11:56:47 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:56:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:56:47 INFO - 'PWD': '/builds/slave/test', 11:56:47 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:56:47 INFO - 'SHELL': '/bin/bash', 11:56:47 INFO - 'SHLVL': '1', 11:56:47 INFO - 'TERM': 'linux', 11:56:47 INFO - 'TMOUT': '86400', 11:56:47 INFO - 'USER': 'cltbld', 11:56:47 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893', 11:56:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:56:47 INFO - '_': '/tools/buildbot/bin/python'} 11:56:47 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 11:56:47 INFO - mozversion application_buildid: 20160715064309 11:56:47 INFO - mozversion application_changeset: 5a9c26f8bb9d599e80c92f6a7f30ad91bd54a854 11:56:47 INFO - mozversion application_display_name: Nightly 11:56:47 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:56:47 INFO - mozversion application_name: Firefox 11:56:47 INFO - mozversion application_remotingname: firefox 11:56:47 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 11:56:47 INFO - mozversion application_vendor: Mozilla 11:56:47 INFO - mozversion application_version: 50.0a1 11:56:47 INFO - mozversion platform_buildid: 20160715064309 11:56:47 INFO - mozversion platform_changeset: 5a9c26f8bb9d599e80c92f6a7f30ad91bd54a854 11:56:47 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 11:56:47 INFO - mozversion platform_version: 50.0a1 11:56:47 INFO - using testdate: 1468609007 11:56:47 INFO - actual date: 1468609007 11:56:47 INFO - starting webserver on 'localhost:55523' 11:56:47 INFO - SUITE-START | Running 2 tests 11:56:47 INFO - TEST-START | dromaeo_css 11:56:47 INFO - operating with platform_type : linux_ 11:56:47 INFO - Initialising browser for dromaeo_css test... 11:56:47 INFO - TEST-INFO | started process 5136 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCdL5Yx/profile http://localhost:55523/getInfo.html) 11:56:51 INFO - PROCESS | 5136 | __metrics Screen width/height:1600/1200 11:56:51 INFO - PROCESS | 5136 | colorDepth:24 11:56:51 INFO - PROCESS | 5136 | Browser inner width/height: 1024/697 11:56:51 INFO - PROCESS | 5136 | __metrics 11:56:52 ERROR - PROCESS | 5136 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2964: TypeError: this.tabs is undefined 11:56:53 INFO - TEST-INFO | 5136: exit 0 11:56:53 INFO - Browser initialized. 11:56:53 INFO - Running cycle 1/1 for dromaeo_css test... 11:56:53 INFO - TEST-INFO | started process 5259 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCdL5Yx/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:57:05 INFO - PROCESS | 5259 | RSS: Main: 167673856 11:57:05 INFO - PROCESS | 5259 | 11:57:54 INFO - PROCESS | 5259 | 1468609074706 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] 12:00:02 INFO - PROCESS | 5259 | Cycle 1(1): loaded http://localhost:55523/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55523/tests/dromaeo/cssquery-ext.html) 12:00:03 INFO - PROCESS | 5259 | RSS: Main: 172224512 12:00:03 INFO - PROCESS | 5259 | 12:03:05 INFO - PROCESS | 5259 | Cycle 1(1): loaded http://localhost:55523/tests/dromaeo/cssquery-ext.html (next: http://localhost:55523/tests/dromaeo/cssquery-jquery.html) 12:03:06 INFO - PROCESS | 5259 | RSS: Main: 168701952 12:03:06 INFO - PROCESS | 5259 | 12:06:07 INFO - PROCESS | 5259 | Cycle 1(1): loaded http://localhost:55523/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55523/tests/dromaeo/cssquery-mootools.html) 12:06:08 INFO - PROCESS | 5259 | RSS: Main: 172310528 12:06:08 INFO - PROCESS | 5259 | 12:09:10 INFO - PROCESS | 5259 | Cycle 1(1): loaded http://localhost:55523/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55523/tests/dromaeo/cssquery-prototype.html) 12:09:10 INFO - PROCESS | 5259 | RSS: Main: 166608896 12:09:10 INFO - PROCESS | 5259 | 12:12:13 INFO - PROCESS | 5259 | Cycle 1(1): loaded http://localhost:55523/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55523/tests/dromaeo/cssquery-yui.html) 12:12:14 INFO - PROCESS | 5259 | RSS: Main: 168775680 12:12:14 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | Cycle 1(1): loaded http://localhost:55523/tests/dromaeo/cssquery-yui.html (next: http://localhost:55523/tests/dromaeo/cssquery-dojo.html) 12:15:16 INFO - PROCESS | 5259 | RSS: Main: 169816064 12:15:16 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | __start_tp_report 12:15:16 INFO - PROCESS | 5259 | _x_x_mozilla_page_load 12:15:16 INFO - PROCESS | 5259 | _x_x_mozilla_page_load_details 12:15:16 INFO - PROCESS | 5259 | |i|pagename|runs| 12:15:16 INFO - PROCESS | 5259 | |0;dojo.html;3086.907392778217;3115.314630781227;3120.8439578021103;3133.8119712817247;3153.8738450461983;5442.428545002772;5457.91813122803;5475.233467314579;5519.116941289394;5521.2270282160525;5331.760070796814;5459.890802183964;5481.205225242337;5487.286652735139;5500.4224556421495;4926.162552366106;4966.925496117561;5050;5117.820876269331;5163.044836705203;770.8980741509478;4939.036887806879;4964.900701985976;5019.498050194969;5083.466236045218;4974.527419895104;4975.950240497603;4983.57967979126;4996.825111121111;5017.749112544395;5020.949790502084;5025.974870125662;5026.5727413169925;5028.522290382408;5060.822871199527;4943.060818444484;4959.553640172366;4972.378452693413;5005.874853128665;5025.924611130836;5454.945450545483;5476.616636835423;5481.205225242357;5519.227308176858;5560.916586251209;5749.108888122348;5777.422257774231;5900.675462849542;5906.025505791582;5915.615484993505;5857.092150716646;5882.000059989812;5905.055191169436;5921.467067963861;5977.103434484862;5426.321709786277;5456.017916774979;5480.26016487773;5488.56091512678;5519.116941289414;5790.71046447676;5933.6736479493175;5935.198748168942;5964.671943043174;5973.253343332083;5784.50831679312;5785.913211301834;5792.189093526909;5795.739191736382;5801.477866991991;5938.406159384027;5941.910871336933;5946.13781001761;5948.434898684618;5948.7323070461935;5818.6217895836635;5866.911996320058;5912.852178695481;5916.7041647918295;5921.259842519685;5901.291844978544;5929.347771745104;5936.257967754031;5939.376365481562;5939.821805345847;4392.956070439319;4488.989977255157;4512.300593408027;4512.909741805145;4549.181147393501;3905.1018265799025;3925.097227637659;3977.6817854571564;3983.6813054956115;3986.9601303986587;5571;5595.888082238333;5634.52106570946;5650.802221922213;5661.858453538694;5789.768409263666;5943.58394912352;5954.970225148846;5957.582969192202;5963.165156878041;5529.778808847682;5586.329640443173;5595.076812326002;5604.8318550443555;5617.185508101303;4950.034743225108;4954.5540901319055;5007.973365460072;5032.6980381177245;5075.543201111844;6160.445559899541;6168.691565421711;6170.10533472644;6170.352113028068;6172.9074063889075;5819.70901454934;5931.940680593311;5968.641881487125;5982.162497250475;5992.101184822312;6018.247719035121;6037.667928263988;6099.603525770811;6126.938730612816;6139.4781443577795;5806.970965145316;5842.298924129132;5848.181254624271;5858.619189752652;5859.062549992152;5804.419558044331;5882.676452794966;5889.49939255151;5941.465268125889;5951.196588460502;5739.426057394227;5803.0424979879535;5806.767729290781;5818;5845.824625261249;5812.18629391877;5821.126830975219;5825.621334613236;5826.475617194473;5831.125331200354;5586.832395027993;5623.128415095667;5644.9435505644415;5722.542196624343;5734.311882574118;5711.543076553949;5769.9711501442225;5786.132080188006;5793.913091303718;5834.912476312774;5605.887882242251;5655.660660360391;5662.8301150965535;5664.716764161858;5665.603407761417 12:15:16 INFO - PROCESS | 5259 | |1;ext.html;583.1282233061573;584.2784161560469;605.8697380063287;617.870247248078;621.9657918814466;41995;42432.15135697284;42639;42757.358639620354;45786;43686.12627747443;44143;44160.3375949361;44290.557094429045;44450.33324500135;8840.336974726904;9057.682981095662;9060.909390906072;9062.139096785828;9081.364304498687;8866.601002954883;8905.77735556613;8909.910900890973;8978.730638080868;8979.371443998923;8963.551822408886;8998.59506322217;9006.504642244674;9015.188633023026;9030.954845225764;8916.821663566725;8940.64237430502;8980.685676001342;8985.101489850962;8989.056149104315;8875.556222188929;8885.600147993357;8910.955445222733;8966.910330896739;8973.910260897437;42051;42377.36433953493;42422.78788606068;42443.15113697709;42537.14925701469;3455.2571197192724;3546.7517273790586;3580.2660454606744;3592.46113083037;3667.651573100551;31722.682773172204;32059.198520037186;32168.356632867213;32208.83895580507;32312.83843580767;4240;4310.655147588185;4317.222899878021;4345.478542574911;4391.143726973241;358911;361063;362374;362904;363070;34230.14424639354;35034.474482882775;59351.406485935455;59367.703161483914;59542;35877.82061089678;36032.81983590065;36033.45949810755;36164.81917590448;36166.63833361685;14900.254987250593;14992.400303987937;15004.24978751058;15012.099274043374;15039.624009399633;13053.34733263333;13074.869251307366;13085.672858178432;13101.148425352321;13118.409671564803;8079.474834135763;8168.877466838002;8176.059753128347;8224.506529608243;8269.46248493846;3169.6988786065285;3185.8088514689193;3188.314512379803;3194.9296985510114;3207.1821685470054;1046.3355769086534;1053.8155822730992;1072.9302595331278;1089.6458650938478;1139.4758411130806;33856;34176.316473670384;34720;36724.7632931484;36762.44856327157;1112.7830073135822;1134.9773004540027;1145.851039364894;1157.8379026936236;1217.4582310871576;17214.569635758955;17536.64926701459;17646.91176544109;17661.558461038578;17666.205020774098;562624;569315;571556;572287;573892;57266;57295.713521432124;57455;57974.130388044214;58148.4185158143;1354.4514471639002;1357.9796303055462;1394.539801865382;1394.6583087143513;1400.369833574875;31125;32192.67807321897;32617.836910815295;32658.346833063682;33004.50493242651;51720.89674619535;52408.47591524036;52620.21069683881;52718.47281527136;53072.73463632657;477518;477708;478929;479469;481026;27591.724082758916;27646.170614881587;27669.584956226074;27985.300367490163;28015.859920700266;46908.29637555507;47756.5224347766;47858.28212576884;47950.28074578814;48616.75691621519;41067;41615.7919210402;41651.084424090026;42539.361909572;42613.5738642622;40624.79687601661;40646.59353406546;40678.79660601678;41162.38256426096;41220;41433;41964.790176048926;42455;42634;44138.83301792303;35768.46347304845;36797.81601091977;37199.628003720696;37606.2478750418;37786.05534861651;29361.265968350963;29415.26461838471;29419.705802941695;29532;29552.852235738683 12:15:16 INFO - PROCESS | 5259 | |2;jquery.html;380.3666894620457;384.298920671797;393.45506473534147;393.5061497820235;402.23775944585014;14188.148711077343;18995.905020474896;19796.10917508712;20626.38120856373;20686.793132068695;18839.24643014281;19002.14490347934;19209.32767353143;20013.399598012045;20019.799802001977;5564.582656300783;5745.166950792132;7039.612821294827;7397.075365579302;7408.259174082603;7312.488125831194;7377;7401.925980740178;7438.442116841232;7445.516041457315;7360.926390736077;7487.288707572772;7492.550446973171;7498.887516687254;7626.466147369686;7653.885191722128;7664.655090520884;7778.844423111563;7781.961090194541;7801;7415.88876166858;7429.925700742978;7445.813854653677;7453.701851925916;7454.813629659247;26335;27245.72754272452;28017;28325.433491330263;28650.713492865012;2543.4785868896834;2730.986345068282;3247.723943464808;3316.8507417166284;3446.362422951737;16188;16230.83769162305;16406.195318514954;16982.915085424618;17193.39823106198;2169.642009068502;2287.3138058582526;2377.6314671225987;2419.9727355045397;2430.5746494363416;88396;100753.9924600752;101334.49332753362;102700;104989;17895.910520447316;18002.819971800378;18243.63512729738;18389.63220735578;18525.629487410446;30799.384012319628;32252.516212256836;32413.35173296521;32484.187895302333;32506.34987300288;9818;9834.950825245827;9932.900670993198;9989.850152247722;10015.549300281506;8136.14570470104;8161.5919204039565;8211.507309561446;8332.33341332692;8378.24595786382;8673.306135509145;8730.519821409756;8745.781355466037;8776.385653004229;9110.134537218953;3496.6852983231124;3505.211327451354;3559.839807208682;3601.7658852174527;3624.8912532624063;392.1118666220955;397.7851959941599;409.21635068843426;916.3173435790245;1043.5251960358019;11343.659690209306;11547.364894930692;11592.246503977214;11659.358735269641;11806.996405305474;418.5187034909878;424.37616703445883;428.41521323393346;439.08450879915097;446.72303172032895;5971.581989260797;6066.757329706762;6073.301570319381;6090;6178.567500275028;184552;184857;186645;187106;187532;77690.6115469419;87216.5113395457;89257;92590.53704731433;95502;454.97725113744843;462.7524274513119;463.25184826505625;466.29822117712627;466.442601091699;11388.544458221579;11723.120765942418;11829.290242585472;11964.64106076819;12071.215371000857;42054.789726051175;42428.787856061754;43186.35220471633;44212;44473.55526444824;61771.691141544004;62020.689896550226;62773;66100.33899660943;66476.66761666161;8464.957675211585;8615.91384086151;8683.523800953979;8801.427907186013;8825.514596697243;9129.406588571721;10949.288296260718;11744.706382340168;12713.745725085262;12924.353782310658;11328.150388720715;11457.083433325148;11491.712707182052;11686.415679215836;11861.406929653655;11138.10895128404;11155.382469541708;11270.774584508099;11376.94311528437;11559.826602601135;11358.829617555579;11480.712982175179;11550.826737598774;11622.6513204604;11885.76228475443;7447.32974032318;7823.178566250462;8587.441816281922;8860.601272942604;8987.146221108984;10421.114205292635;10941.617043403443;11178.105751539695;11203.663890083311;11258.943705281421 12:15:16 INFO - PROCESS | 5259 | |3;mootools.html;1488.2335597167457;1502.4065494129818;1646.6953613581481;1793.8833975791565;1806.7922188948266;7984.243466437389;8653.350998675101;8728.47629142252;9241.353105282624;9271.304652151082;8733.519656418894;9051.275897928166;9084.591193396296;9116.635334586608;9128.771780705485;2306.642470417084;2321.791038806507;2324.5931961906686;2338.1232037985756;2350;2301.3326135420707;2320.0487800002;2323.628219484874;2333.369990102671;2353.2587235020915;2320.5010922651627;2322.628379459287;2335.2877372401413;2336.065573770497;2336.2991102669216;2295.632698768206;2298.138198175684;2306.250468597704;2308.272894038381;2319.605667036608;2261.5929132756096;2266.4220623741007;2272.0798076778933;2284.120613563773;2294.977050229493;9040.593173307218;9119;9124.680636177769;9193.632254709804;9209.263258939269;5215.817446389358;5348.037353276409;5373.623846330719;5389.568834493231;5390.164524498709;3270.787398819069;3379.7509347307614;3471.3057388522398;3488.9127771805656;3534.9116272093147;1018.6842078955474;1038.7662775875442;1043.6712435582767;1051.0488008352454;1064.8455973883742;12622.68443288916;12636.989040876708;12689.302088385135;12708.555200568027;12766.489340426464;4483.663725220556;4492.640588752892;4634.328022436728;4646.256598944153;4706.458757242893;10704.1436685065;10717.0890474309;10725.785484290427;10753.83869241962;10763.730906727238;5242.082635538765;5284.180951952453;5289.18017707256;5291.1798671206025;5293;4445.933311000337;4791.377120974251;4870.707757534559;4952.8113252819785;4963.6277279204205;3883.708721845873;3900.941485877714;3978.085040440657;4020.577839326887;4095.2014357200655;1250.6185613387822;1260.4013093780563;1265.4811527273773;1269.428757059327;1282.730626568431;1032.4682788363998;1041.4376236832177;1043.415687215162;1048.449563978902;1054.599252284127;5991.820245392558;6290.4653104485715;6304.148939893147;6488.805335839932;6559.36015996001;978.3836183204536;1003.3678782367208;1008.3042700536606;1026.820306446369;1027.1320733979776;4245.87262382129;4504.9099018020115;4524.208263553931;4531.365608814768;4536.251518499476;10543;10661.893381066246;10726.624568140078;10775.515101820436;10783.946080269705;10029.749256268651;10306.845397319046;10612.416317102634;10619.991100845407;10684.358938463716;7975.481593696391;8035.879461808077;8039.155888631726;8066.919330806617;8085.272325490734;6294.559380843297;6546.738130474918;6615.933840661532;6647.235567909753;6658.1344425224415;9274.860877086714;10549.997750213717;10652.348885922695;10746;10746.355218686904;9723.9027609723;9837.409755414697;9928.007199280015;9985.400875947467;10045.347052441568;7032.964835175791;7731.38148948094;7799.6100194988885;7927.682892684228;7947.801304967422;8820.64717411322;8824.5587720615;8861.202491775772;8867.113288671082;8926.464412135292;7806.687732490636;7806.843863122819;7881.093674227308;7898.802529936797;8076.919230807852;7903.091144518224;7947.165547617417;7995.680172793023;8054.4361894669155;8054.597270136587;7366.226546212571;7398.482106252511;7457.179710231979;7493.737719180021;7498.662560184914;5393.40672526014;5431.022415965006;5463.180522921593;5464.1257398816;5473.343198816008;5477.808276710296;5484.424135465719;5547.639403438763;5590.776368945197;5658.858528536654 12:15:16 INFO - PROCESS | 5259 | |4;prototype.html;307.1384765732122;307.2549068508865;311.9500879859223;312.06225292994554;314.5627577667042;5681.358168451674;5708.08670612702;5720.971395143024;5742.885142297151;5743.712814359286;5562.749676264568;5564.720114373697;5584.664920104787;5616.66300021999;5662.688552129631;4141.420201171831;4152.584741525839;4307.784610769449;4331.783410829462;4356.455443069616;4302.913941721164;4323.805428755713;4344.956550434503;4355.390245365651;4369.388285640013;4315.136972605475;4330.523642399334;4332.631726303268;4337.284348082562;4344.131173765244;4189.183109293689;4276.3799249109015;4326.502452218004;4332.1119170569955;4357.84747533838;3809.2191100824266;3819.6371344722206;3824.5275568905895;3838.136419305662;3841.2125514269787;5519.834404967857;5531.363893152299;5545.334559852843;5546.55627549795;5566.693831839248;4894.583960363373;4961.131801934647;4984.850454486371;4985.576226020793;4992.625553083533;5862.912056319158;5886.23478947734;5900.557458190653;5926.111083337534;5927.577381428469;4197.9370309445385;4199;4204.348326009474;4207.389928460387;4208.579142085798;6037.818865434044;6109.114178444145;6130.417610327012;6159.29168145669;6178.907316390258;4265.189613973335;4274.653484152482;4287.656987440997;4289.378040184156;4299.634531064832;4280.935785963213;4316.1583491219535;4318.157959197926;4321.891952701145;4338.175746608197;4852;4916.459189489154;4921.9015619688125;4931.432885218174;4981.850544483671;5935.584509084322;5947.910781338283;5964.343922168558;5969.940300597025;5995.52035837132;1468.4713503138862;1494.6039299585618;1500.2348802111003;1505.954821355361;1512.9470468533768;925.708401853414;955.6368579939578;966.1015255812163;969.781799095212;977.4330888084894;5691.800786972519;5696.860627874442;5737.77048918047;5742.827715168552;5781.624194427349;6083.969580152071;6093.664848433379;6136.693165341715;6156.353582873823;6162.352952939877;5630.18362337467;5631.182886615381;5671.234383358276;5734.512566431817;5736.942630573641;3236.579244698174;3236.919077023046;3238.2390138317946;3245.772795904264;3252.9349413011605;6103.6032657877095;6179.0422484514975;6194.938050619527;6214.2542894852;6245.156903818017;6163;6174.209479250967;6242.968785156136;6248.375162483806;6267.874642507124;5926.585139040312;6219.782307619212;6243.781467648701;6261.8747625047245;6303.46420554258;5976.312724036791;6015.789447369321;6038.305594856648;6042.585938944482;6090.23872015998;5988.640681559121;6036.098628931873;6048.183495228088;6048.455638992512;6063.878722425615;5939.732712027882;6199.442050215503;6214.533909956862;6252.531060170414;6273.341299163704;4155.605217504332;4163.396307535451;4163.708540402143;4167.437395951508;4182.895427614334;5921.230240068763;5989.670568118795;6016.969915150396;6057.333693293822;6080.361562035922;5750.396208398225;5841.649501029951;5843;5859.5019423349495;5960.672163031075;5916.0477042574985;5936;5937.139114828412;5949.7802950395935;5965.970170149121;5259.658122222043;5756.280464941882;5814.796482123105;5829.562782791223;5881.941180588139;5930.309861689398;5959.195508606283;5987.700614969322;6022.608530445507;6030.30651475086;5614;5840.10914597277;5855.2973643163095;5881.411858814085;5894.970525147347 12:15:16 INFO - PROCESS | 5259 | |5;yui.html;739.781764379508;768.7117331000875;792.6868886789715;823.5347028928655;866.6446756829697;15165.317560709767;15638.06171629703;15649.45226917058;15649.608759780996;15682.921585392085;14667.339969701363;14767.483138090169;14860.851391486081;15760.369585216578;16241.431549895757;801.6913488307;818.1368656067846;822.8477731619639;823.4853216739538;824.4023083264645;804.1315379390273;830.2776584371575;830.3689196210893;842.296682270305;843.0389356134012;856.5117882806802;858.6479543387212;859.5315553023618;860.0883063952231;861.5089399042548;848.0459483081534;850.7320194138857;854.6624083486988;855.6278019061729;857.2028013947026;619.1764952613058;621.4686443091138;622.4024936061387;622.8380621038517;623.323693792236;15000.049993500885;15054;15145.394184232617;15163.393464261417;15195.848041519665;15111;15200.695986080327;15211.543653690407;15258.313375898111;15360.769588456182;12489.75020499594;12861.16402433848;12910.450745910457;12954.222746635232;12987.740245195044;3901.43429202764;3949.9012524686827;3964.682825373963;3968.5436174839974;4075.042365044212;80517.59741201316;80990.59504702498;81014.59492702498;81136;85499.14500854973;11124.489037532516;11262.493187806569;11700.473478693479;11932.940335298441;11977.461014254379;19540;19584.51038724015;19604.901975490033;19649.705254421195;19691.901540492494;8049.6377663005305;8253.669853205925;8426.41015128935;8569.143085691381;8720.95639521811;4795.688280261772;4875.634327425386;4899.877503062381;4989.625778066659;5000.024995125988;3518.9296214075575;3633.745637805381;3634.672879440863;3639.8726044588843;3640.12636967126;604.1013745280476;610.2128254551578;610.3652201710261;616.0420546050934;618.2766163588612;746.1121265693915;765.9080910290801;766.8082979255187;776.825214326772;776.9533827970226;9944.558039084437;9983.700488985342;10082.445465499468;10356.844647330296;10385.896141038493;636.9331220221902;643.8579730913114;732.5641243460133;763.6220071064859;788.4599049650893;4557.453105627346;4675.392199014106;4688.882777930579;4690.6012988895645;4765.404324459442;119212;119649;120884;121888;123005.38497307456;99020.5048974765;100522.4973875126;101384.49307753413;101635.49182254041;101727;87325.563372184;88880.55559722289;89249;89459;90600.5469972646;9139.405938614234;9187.219086377732;9207.769805754642;9220.26237900953;9304.116108969638;53989.460105398444;55350;55354.72322638361;56442.7177864108;57610.71194644;78124;79940.20059799327;80918.19081809343;81360.59319703364;81363.59318203371;11640.35978021217;11661.825072623747;11971.76056478883;11974.161808673309;12285.93857030745;13120;13694.65763355924;13848.169109853037;13924.791128132883;14065.437382504586;11531.827022594836;11872.347020913932;11954.163208575315;12001.939990299992;12027.21823081497;12408.317542535247;12781.297028663514;12783.80824287655;13138.343082845628;13518.188908665512;12996.285204313854;13104.868951310746;13145.802812957621;13302.201867887958;13554.390052447467;11663.88336116662;11738.652269545953;11781.52873885035;12309;12567.874321257035;12141.75716485683;12161.695957600778;12288.50845966187;12611.30637814929;12694.301813400352 12:15:16 INFO - PROCESS | 5259 | __end_tp_report 12:15:16 INFO - PROCESS | 5259 | __start_cc_report 12:15:16 INFO - PROCESS | 5259 | _x_x_mozilla_cycle_collect,368 12:15:16 INFO - PROCESS | 5259 | __end_cc_report 12:15:16 INFO - PROCESS | 5259 | __startTimestamp1468610116580__endTimestamp 12:15:16 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | ------- Summary: start ------- 12:15:16 INFO - PROCESS | 5259 | Number of tests: 6 12:15:16 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | [#0] dojo.html Cycles:165 Average:5445.29 Median:5711.54 stddev:735.73 (12.9%) stddev-sans-first:714.35 12:15:16 INFO - PROCESS | 5259 | Values: 3086.9 3115.3 3120.8 3133.8 3153.9 5442.4 5457.9 5475.2 5519.1 5521.2 5331.8 5459.9 5481.2 5487.3 5500.4 4926.2 4966.9 5050.0 5117.8 5163.0 770.9 4939.0 4964.9 5019.5 5083.5 4974.5 4976.0 4983.6 4996.8 5017.7 5020.9 5026.0 5026.6 5028.5 5060.8 4943.1 4959.6 4972.4 5005.9 5025.9 5454.9 5476.6 5481.2 5519.2 5560.9 5749.1 5777.4 5900.7 5906.0 5915.6 5857.1 5882.0 5905.1 5921.5 5977.1 5426.3 5456.0 5480.3 5488.6 5519.1 5790.7 5933.7 5935.2 5964.7 5973.3 5784.5 5785.9 5792.2 5795.7 5801.5 5938.4 5941.9 5946.1 5948.4 5948.7 5818.6 5866.9 5912.9 5916.7 5921.3 5901.3 5929.3 5936.3 5939.4 5939.8 4393.0 4489.0 4512.3 4512.9 4549.2 3905.1 3925.1 3977.7 3983.7 3987.0 5571.0 5595.9 5634.5 5650.8 5661.9 5789.8 5943.6 5955.0 5957.6 5963.2 5529.8 5586.3 5595.1 5604.8 5617.2 4950.0 4954.6 5008.0 5032.7 5075.5 6160.4 6168.7 6170.1 6170.4 6172.9 5819.7 5931.9 5968.6 5982.2 5992.1 6018.2 6037.7 6099.6 6126.9 6139.5 5807.0 5842.3 5848.2 5858.6 5859.1 5804.4 5882.7 5889.5 5941.5 5951.2 5739.4 5803.0 5806.8 5818.0 5845.8 5812.2 5821.1 5825.6 5826.5 5831.1 5586.8 5623.1 5644.9 5722.5 5734.3 5711.5 5770.0 5786.1 5793.9 5834.9 5605.9 5655.7 5662.8 5664.7 5665.6 12:15:16 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | [#1] ext.html Cycles:180 Average:61578.78 Median:41807.94 stddev:127191.82 (304.2%) stddev-sans-first:127466.18 12:15:16 INFO - PROCESS | 5259 | Values: 583.1 584.3 605.9 617.9 622.0 41995.0 42432.2 42639.0 42757.4 45786.0 43686.1 44143.0 44160.3 44290.6 44450.3 8840.3 9057.7 9060.9 9062.1 9081.4 8866.6 8905.8 8909.9 8978.7 8979.4 8963.6 8998.6 9006.5 9015.2 9031.0 8916.8 8940.6 8980.7 8985.1 8989.1 8875.6 8885.6 8911.0 8966.9 8973.9 42051.0 42377.4 42422.8 42443.2 42537.1 3455.3 3546.8 3580.3 3592.5 3667.7 31722.7 32059.2 32168.4 32208.8 32312.8 4240.0 4310.7 4317.2 4345.5 4391.1 358911.0 361063.0 362374.0 362904.0 363070.0 34230.1 35034.5 59351.4 59367.7 59542.0 35877.8 36032.8 36033.5 36164.8 36166.6 14900.3 14992.4 15004.2 15012.1 15039.6 13053.3 13074.9 13085.7 13101.1 13118.4 8079.5 8168.9 8176.1 8224.5 8269.5 3169.7 3185.8 3188.3 3194.9 3207.2 1046.3 1053.8 1072.9 1089.6 1139.5 33856.0 34176.3 34720.0 36724.8 36762.4 1112.8 1135.0 1145.9 1157.8 1217.5 17214.6 17536.6 17646.9 17661.6 17666.2 562624.0 569315.0 571556.0 572287.0 573892.0 57266.0 57295.7 57455.0 57974.1 58148.4 1354.5 1358.0 1394.5 1394.7 1400.4 31125.0 32192.7 32617.8 32658.3 33004.5 51720.9 52408.5 52620.2 52718.5 53072.7 477518.0 477708.0 478929.0 479469.0 481026.0 27591.7 27646.2 27669.6 27985.3 28015.9 46908.3 47756.5 47858.3 47950.3 48616.8 41067.0 41615.8 41651.1 42539.4 42613.6 40624.8 40646.6 40678.8 41162.4 41220.0 41433.0 41964.8 42455.0 42634.0 44138.8 35768.5 36797.8 37199.6 37606.2 37786.1 29361.3 29415.3 29419.7 29532.0 29552.9 12:15:16 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | [#2] jquery.html Cycles:180 Average:22004.70 Median:382.33 stddev:35762.01 (9353.6%) stddev-sans-first:35825.47 12:15:16 INFO - PROCESS | 5259 | Values: 380.4 384.3 393.5 393.5 402.2 14188.1 18995.9 19796.1 20626.4 20686.8 18839.2 19002.1 19209.3 20013.4 20019.8 5564.6 5745.2 7039.6 7397.1 7408.3 7312.5 7377.0 7401.9 7438.4 7445.5 7360.9 7487.3 7492.6 7498.9 7626.5 7653.9 7664.7 7778.8 7782.0 7801.0 7415.9 7429.9 7445.8 7453.7 7454.8 26335.0 27245.7 28017.0 28325.4 28650.7 2543.5 2731.0 3247.7 3316.9 3446.4 16188.0 16230.8 16406.2 16982.9 17193.4 2169.6 2287.3 2377.6 2420.0 2430.6 88396.0 100754.0 101334.5 102700.0 104989.0 17895.9 18002.8 18243.6 18389.6 18525.6 30799.4 32252.5 32413.4 32484.2 32506.3 9818.0 9835.0 9932.9 9989.9 10015.5 8136.1 8161.6 8211.5 8332.3 8378.2 8673.3 8730.5 8745.8 8776.4 9110.1 3496.7 3505.2 3559.8 3601.8 3624.9 392.1 397.8 409.2 916.3 1043.5 11343.7 11547.4 11592.2 11659.4 11807.0 418.5 424.4 428.4 439.1 446.7 5971.6 6066.8 6073.3 6090.0 6178.6 184552.0 184857.0 186645.0 187106.0 187532.0 77690.6 87216.5 89257.0 92590.5 95502.0 455.0 462.8 463.3 466.3 466.4 11388.5 11723.1 11829.3 11964.6 12071.2 42054.8 42428.8 43186.4 44212.0 44473.6 61771.7 62020.7 62773.0 66100.3 66476.7 8465.0 8615.9 8683.5 8801.4 8825.5 9129.4 10949.3 11744.7 12713.7 12924.4 11328.2 11457.1 11491.7 11686.4 11861.4 11138.1 11155.4 11270.8 11376.9 11559.8 11358.8 11480.7 11550.8 11622.7 11885.8 7447.3 7823.2 8587.4 8860.6 8987.1 10421.1 10941.6 11178.1 11203.7 11258.9 12:15:16 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | [#3] mootools.html Cycles:180 Average:5918.43 Median:4533.81 stddev:3331.85 (73.5%) stddev-sans-first:3324.56 12:15:16 INFO - PROCESS | 5259 | Values: 1488.2 1502.4 1646.7 1793.9 1806.8 7984.2 8653.4 8728.5 9241.4 9271.3 8733.5 9051.3 9084.6 9116.6 9128.8 2306.6 2321.8 2324.6 2338.1 2350.0 2301.3 2320.0 2323.6 2333.4 2353.3 2320.5 2322.6 2335.3 2336.1 2336.3 2295.6 2298.1 2306.3 2308.3 2319.6 2261.6 2266.4 2272.1 2284.1 2295.0 9040.6 9119.0 9124.7 9193.6 9209.3 5215.8 5348.0 5373.6 5389.6 5390.2 3270.8 3379.8 3471.3 3488.9 3534.9 1018.7 1038.8 1043.7 1051.0 1064.8 12622.7 12637.0 12689.3 12708.6 12766.5 4483.7 4492.6 4634.3 4646.3 4706.5 10704.1 10717.1 10725.8 10753.8 10763.7 5242.1 5284.2 5289.2 5291.2 5293.0 4445.9 4791.4 4870.7 4952.8 4963.6 3883.7 3900.9 3978.1 4020.6 4095.2 1250.6 1260.4 1265.5 1269.4 1282.7 1032.5 1041.4 1043.4 1048.4 1054.6 5991.8 6290.5 6304.1 6488.8 6559.4 978.4 1003.4 1008.3 1026.8 1027.1 4245.9 4504.9 4524.2 4531.4 4536.3 10543.0 10661.9 10726.6 10775.5 10783.9 10029.7 10306.8 10612.4 10620.0 10684.4 7975.5 8035.9 8039.2 8066.9 8085.3 6294.6 6546.7 6615.9 6647.2 6658.1 9274.9 10550.0 10652.3 10746.0 10746.4 9723.9 9837.4 9928.0 9985.4 10045.3 7033.0 7731.4 7799.6 7927.7 7947.8 8820.6 8824.6 8861.2 8867.1 8926.5 7806.7 7806.8 7881.1 7898.8 8076.9 7903.1 7947.2 7995.7 8054.4 8054.6 7366.2 7398.5 7457.2 7493.7 7498.7 5393.4 5431.0 5463.2 5464.1 5473.3 5477.8 5484.4 5547.6 5590.8 5658.9 12:15:16 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | [#4] prototype.html Cycles:180 Average:4957.14 Median:5735.73 stddev:1480.18 (25.8%) stddev-sans-first:1442.59 12:15:16 INFO - PROCESS | 5259 | Values: 307.1 307.3 312.0 312.1 314.6 5681.4 5708.1 5721.0 5742.9 5743.7 5562.7 5564.7 5584.7 5616.7 5662.7 4141.4 4152.6 4307.8 4331.8 4356.5 4302.9 4323.8 4345.0 4355.4 4369.4 4315.1 4330.5 4332.6 4337.3 4344.1 4189.2 4276.4 4326.5 4332.1 4357.8 3809.2 3819.6 3824.5 3838.1 3841.2 5519.8 5531.4 5545.3 5546.6 5566.7 4894.6 4961.1 4984.9 4985.6 4992.6 5862.9 5886.2 5900.6 5926.1 5927.6 4197.9 4199.0 4204.3 4207.4 4208.6 6037.8 6109.1 6130.4 6159.3 6178.9 4265.2 4274.7 4287.7 4289.4 4299.6 4280.9 4316.2 4318.2 4321.9 4338.2 4852.0 4916.5 4921.9 4931.4 4981.9 5935.6 5947.9 5964.3 5969.9 5995.5 1468.5 1494.6 1500.2 1506.0 1512.9 925.7 955.6 966.1 969.8 977.4 5691.8 5696.9 5737.8 5742.8 5781.6 6084.0 6093.7 6136.7 6156.4 6162.4 5630.2 5631.2 5671.2 5734.5 5736.9 3236.6 3236.9 3238.2 3245.8 3252.9 6103.6 6179.0 6194.9 6214.3 6245.2 6163.0 6174.2 6243.0 6248.4 6267.9 5926.6 6219.8 6243.8 6261.9 6303.5 5976.3 6015.8 6038.3 6042.6 6090.2 5988.6 6036.1 6048.2 6048.5 6063.9 5939.7 6199.4 6214.5 6252.5 6273.3 4155.6 4163.4 4163.7 4167.4 4182.9 5921.2 5989.7 6017.0 6057.3 6080.4 5750.4 5841.6 5843.0 5859.5 5960.7 5916.0 5936.0 5937.1 5949.8 5966.0 5259.7 5756.3 5814.8 5829.6 5881.9 5930.3 5959.2 5987.7 6022.6 6030.3 5614.0 5840.1 5855.3 5881.4 5895.0 12:15:16 INFO - PROCESS | 5259 | 12:15:16 INFO - PROCESS | 5259 | [#5] yui.html Cycles:180 Average:21496.87 Median:4021.79 stddev:31462.79 (782.3%) stddev-sans-first:31512.45 12:15:16 INFO - PROCESS | 5259 | Values: 739.8 768.7 792.7 823.5 866.6 15165.3 15638.1 15649.5 15649.6 15682.9 14667.3 14767.5 14860.9 15760.4 16241.4 801.7 818.1 822.8 823.5 824.4 804.1 830.3 830.4 842.3 843.0 856.5 858.6 859.5 860.1 861.5 848.0 850.7 854.7 855.6 857.2 619.2 621.5 622.4 622.8 623.3 15000.0 15054.0 15145.4 15163.4 15195.8 15111.0 15200.7 15211.5 15258.3 15360.8 12489.8 12861.2 12910.5 12954.2 12987.7 3901.4 3949.9 3964.7 3968.5 4075.0 80517.6 80990.6 81014.6 81136.0 85499.1 11124.5 11262.5 11700.5 11932.9 11977.5 19540.0 19584.5 19604.9 19649.7 19691.9 8049.6 8253.7 8426.4 8569.1 8721.0 4795.7 4875.6 4899.9 4989.6 5000.0 3518.9 3633.7 3634.7 3639.9 3640.1 604.1 610.2 610.4 616.0 618.3 746.1 765.9 766.8 776.8 777.0 9944.6 9983.7 10082.4 10356.8 10385.9 636.9 643.9 732.6 763.6 788.5 4557.5 4675.4 4688.9 4690.6 4765.4 119212.0 119649.0 120884.0 121888.0 123005.4 99020.5 100522.5 101384.5 101635.5 101727.0 87325.6 88880.6 89249.0 89459.0 90600.5 9139.4 9187.2 9207.8 9220.3 9304.1 53989.5 55350.0 55354.7 56442.7 57610.7 78124.0 79940.2 80918.2 81360.6 81363.6 11640.4 11661.8 11971.8 11974.2 12285.9 13120.0 13694.7 13848.2 13924.8 14065.4 11531.8 11872.3 11954.2 12001.9 12027.2 12408.3 12781.3 12783.8 13138.3 13518.2 12996.3 13104.9 13145.8 13302.2 13554.4 11663.9 11738.7 11781.5 12309.0 12567.9 12141.8 12161.7 12288.5 12611.3 12694.3 12:15:16 INFO - PROCESS | 5259 | -------- Summary: end -------- 12:15:16 INFO - PROCESS | 5259 | 12:15:17 INFO - TEST-INFO | 5259: exit 0 12:15:17 INFO - TEST-OK | dromaeo_css | took 1110113ms 12:15:17 INFO - TEST-START | kraken 12:15:17 INFO - operating with platform_type : linux_ 12:15:17 INFO - Initialising browser for kraken test... 12:15:17 INFO - TEST-INFO | started process 5507 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUIBcgt/profile http://localhost:55523/getInfo.html) 12:15:22 INFO - PROCESS | 5507 | __metrics Screen width/height:1600/1200 12:15:22 INFO - PROCESS | 5507 | colorDepth:24 12:15:22 INFO - PROCESS | 5507 | Browser inner width/height: 1024/697 12:15:22 INFO - PROCESS | 5507 | __metrics 12:15:22 ERROR - PROCESS | 5507 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2964: TypeError: this.tabs is undefined 12:15:23 INFO - TEST-INFO | 5507: exit 0 12:15:23 INFO - Browser initialized. 12:15:23 INFO - Running cycle 1/1 for kraken test... 12:15:23 INFO - TEST-INFO | started process 5629 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUIBcgt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:15:35 INFO - PROCESS | 5629 | RSS: Main: 167682048 12:15:35 INFO - PROCESS | 5629 | 12:15:37 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55523/tests/kraken/driver.html?testName=audio-beat-detection) 12:15:38 INFO - PROCESS | 5629 | RSS: Main: 173031424 12:15:38 INFO - PROCESS | 5629 | 12:15:41 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55523/tests/kraken/driver.html?testName=audio-dft) 12:15:41 INFO - PROCESS | 5629 | RSS: Main: 172142592 12:15:41 INFO - PROCESS | 5629 | 12:15:44 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55523/tests/kraken/driver.html?testName=audio-fft) 12:15:45 INFO - PROCESS | 5629 | RSS: Main: 167264256 12:15:45 INFO - PROCESS | 5629 | 12:15:47 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55523/tests/kraken/driver.html?testName=audio-oscillator) 12:15:48 INFO - PROCESS | 5629 | RSS: Main: 168218624 12:15:48 INFO - PROCESS | 5629 | 12:15:50 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55523/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:15:51 INFO - PROCESS | 5629 | RSS: Main: 168865792 12:15:51 INFO - PROCESS | 5629 | 12:15:54 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55523/tests/kraken/driver.html?testName=imaging-darkroom) 12:15:54 INFO - PROCESS | 5629 | RSS: Main: 169066496 12:15:54 INFO - PROCESS | 5629 | 12:15:58 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55523/tests/kraken/driver.html?testName=imaging-desaturate) 12:15:58 INFO - PROCESS | 5629 | RSS: Main: 169406464 12:15:58 INFO - PROCESS | 5629 | 12:16:01 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55523/tests/kraken/driver.html?testName=json-parse-financial) 12:16:02 INFO - PROCESS | 5629 | RSS: Main: 169250816 12:16:02 INFO - PROCESS | 5629 | 12:16:03 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55523/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:16:04 INFO - PROCESS | 5629 | RSS: Main: 169156608 12:16:04 INFO - PROCESS | 5629 | 12:16:06 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55523/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:16:06 INFO - PROCESS | 5629 | RSS: Main: 169312256 12:16:06 INFO - PROCESS | 5629 | 12:16:08 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55523/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:16:09 INFO - PROCESS | 5629 | RSS: Main: 169848832 12:16:09 INFO - PROCESS | 5629 | 12:16:12 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55523/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:16:12 INFO - PROCESS | 5629 | RSS: Main: 169820160 12:16:12 INFO - PROCESS | 5629 | 12:16:15 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55523/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:16:16 INFO - PROCESS | 5629 | RSS: Main: 169676800 12:16:16 INFO - PROCESS | 5629 | 12:16:17 INFO - PROCESS | 5629 | Cycle 1(1): loaded http://localhost:55523/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55523/tests/kraken/driver.html?testName=ai-astar) 12:16:18 INFO - PROCESS | 5629 | RSS: Main: 170373120 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | __start_tp_report 12:16:18 INFO - PROCESS | 5629 | _x_x_mozilla_page_load 12:16:18 INFO - PROCESS | 5629 | _x_x_mozilla_page_load_details 12:16:18 INFO - PROCESS | 5629 | |i|pagename|runs| 12:16:18 INFO - PROCESS | 5629 | |0;ai-astar;104;114;106;112;113;112;113;112;112;111 12:16:18 INFO - PROCESS | 5629 | |1;audio-beat-detection;157;125;144;178;118;148;149;118;179;127 12:16:18 INFO - PROCESS | 5629 | |2;audio-dft;163;162;161;161;164;163;168;166;164;164 12:16:18 INFO - PROCESS | 5629 | |3;audio-fft;76;76;75;174;76;74;74;75;159;76 12:16:18 INFO - PROCESS | 5629 | |4;audio-oscillator;85;84;148;85;84;84;149;84;84;146 12:16:18 INFO - PROCESS | 5629 | |5;imaging-gaussian-blur;118;117;117;117;116;118;117;117;118;117 12:16:18 INFO - PROCESS | 5629 | |6;imaging-darkroom;147;146;147;147;149;148;147;146;146;147 12:16:18 INFO - PROCESS | 5629 | |7;imaging-desaturate;95;97;96;95;95;95;95;97;96;96 12:16:18 INFO - PROCESS | 5629 | |8;json-parse-financial;57;55;55;55;56;55;55;55;54;54 12:16:18 INFO - PROCESS | 5629 | |9;json-stringify-tinderbox;63;64;63;64;63;62;63;64;65;66 12:16:18 INFO - PROCESS | 5629 | |10;stanford-crypto-aes;76;77;78;77;76;75;83;76;85;77 12:16:18 INFO - PROCESS | 5629 | |11;stanford-crypto-ccm;127;127;130;123;123;121;137;127;158;130 12:16:18 INFO - PROCESS | 5629 | |12;stanford-crypto-pbkdf2;160;160;168;163;162;158;158;171;165;160 12:16:18 INFO - PROCESS | 5629 | |13;stanford-crypto-sha256-iterative;64;76;65;64;69;63;63;63;64;69 12:16:18 INFO - PROCESS | 5629 | __end_tp_report 12:16:18 INFO - PROCESS | 5629 | __start_cc_report 12:16:18 INFO - PROCESS | 5629 | _x_x_mozilla_cycle_collect,925 12:16:18 INFO - PROCESS | 5629 | __end_cc_report 12:16:18 INFO - PROCESS | 5629 | __startTimestamp1468610178188__endTimestamp 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | ------- Summary: start ------- 12:16:18 INFO - PROCESS | 5629 | Number of tests: 14 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#0] ai-astar Cycles:10 Average:110.90 Median:112.00 stddev:3.25 (2.9%) stddev-sans-first:2.29 12:16:18 INFO - PROCESS | 5629 | Values: 104.0 114.0 106.0 112.0 113.0 112.0 113.0 112.0 112.0 111.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#1] audio-beat-detection Cycles:10 Average:144.30 Median:148.50 stddev:22.59 (15.2%) stddev-sans-first:23.49 12:16:18 INFO - PROCESS | 5629 | Values: 157.0 125.0 144.0 178.0 118.0 148.0 149.0 118.0 179.0 127.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#2] audio-dft Cycles:10 Average:163.60 Median:164.00 stddev:2.17 (1.3%) stddev-sans-first:2.29 12:16:18 INFO - PROCESS | 5629 | Values: 163.0 162.0 161.0 161.0 164.0 163.0 168.0 166.0 164.0 164.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#3] audio-fft Cycles:10 Average:93.50 Median:75.50 stddev:38.64 (51.2%) stddev-sans-first:40.47 12:16:18 INFO - PROCESS | 5629 | Values: 76.0 76.0 75.0 174.0 76.0 74.0 74.0 75.0 159.0 76.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#4] audio-oscillator Cycles:10 Average:103.30 Median:84.00 stddev:30.63 (36.5%) stddev-sans-first:31.76 12:16:18 INFO - PROCESS | 5629 | Values: 85.0 84.0 148.0 85.0 84.0 84.0 149.0 84.0 84.0 146.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.00 stddev:0.63 (0.5%) stddev-sans-first:0.60 12:16:18 INFO - PROCESS | 5629 | Values: 118.0 117.0 117.0 117.0 116.0 118.0 117.0 117.0 118.0 117.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:0.94 (0.6%) stddev-sans-first:1.00 12:16:18 INFO - PROCESS | 5629 | Values: 147.0 146.0 147.0 147.0 149.0 148.0 147.0 146.0 146.0 147.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.82 (0.9%) stddev-sans-first:0.83 12:16:18 INFO - PROCESS | 5629 | Values: 95.0 97.0 96.0 95.0 95.0 95.0 95.0 97.0 96.0 96.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#8] json-parse-financial Cycles:10 Average:55.10 Median:55.00 stddev:0.88 (1.6%) stddev-sans-first:0.60 12:16:18 INFO - PROCESS | 5629 | Values: 57.0 55.0 55.0 55.0 56.0 55.0 55.0 55.0 54.0 54.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#9] json-stringify-tinderbox Cycles:10 Average:63.70 Median:64.00 stddev:1.16 (1.8%) stddev-sans-first:1.20 12:16:18 INFO - PROCESS | 5629 | Values: 63.0 64.0 63.0 64.0 63.0 62.0 63.0 64.0 65.0 66.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#10] stanford-crypto-aes Cycles:10 Average:78.00 Median:77.00 stddev:3.30 (4.3%) stddev-sans-first:3.42 12:16:18 INFO - PROCESS | 5629 | Values: 76.0 77.0 78.0 77.0 76.0 75.0 83.0 76.0 85.0 77.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#11] stanford-crypto-ccm Cycles:10 Average:130.30 Median:128.50 stddev:10.74 (8.4%) stddev-sans-first:11.32 12:16:18 INFO - PROCESS | 5629 | Values: 127.0 127.0 130.0 123.0 123.0 121.0 137.0 127.0 158.0 130.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:162.50 Median:162.50 stddev:4.33 (2.7%) stddev-sans-first:4.49 12:16:18 INFO - PROCESS | 5629 | Values: 160.0 160.0 168.0 163.0 162.0 158.0 158.0 171.0 165.0 160.0 12:16:18 INFO - PROCESS | 5629 | 12:16:18 INFO - PROCESS | 5629 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.00 Median:64.50 stddev:4.19 (6.5%) stddev-sans-first:4.38 12:16:18 INFO - PROCESS | 5629 | Values: 64.0 76.0 65.0 64.0 69.0 63.0 63.0 63.0 64.0 69.0 12:16:18 INFO - PROCESS | 5629 | -------- Summary: end -------- 12:16:18 INFO - PROCESS | 5629 | 12:16:19 INFO - TEST-INFO | 5629: exit 0 12:16:19 INFO - TEST-OK | kraken | took 61929ms 12:16:19 INFO - SUITE-END | took 1172s 12:16:19 INFO - Completed test suite (00:19:32) 12:16:19 INFO - javascript benchmark 12:16:19 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7345.088578891803, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3086.907392778217, 3115.314630781227, 3120.8439578021103, 3133.8119712817247, 3153.8738450461983, 5442.428545002772, 5457.91813122803, 5475.233467314579, 5519.116941289394, 5521.2270282160525, 5331.760070796814, 5459.890802183964, 5481.205225242337, 5487.286652735139, 5500.4224556421495, 4926.162552366106, 4966.925496117561, 5050.0, 5117.820876269331, 5163.044836705203, 770.8980741509478, 4939.036887806879, 4964.900701985976, 5019.498050194969, 5083.466236045218, 4974.527419895104, 4975.950240497603, 4983.57967979126, 4996.825111121111, 5017.749112544395, 5020.949790502084, 5025.974870125662, 5026.5727413169925, 5028.522290382408, 5060.822871199527, 4943.060818444484, 4959.553640172366, 4972.378452693413, 5005.874853128665, 5025.924611130836, 5454.945450545483, 5476.616636835423, 5481.205225242357, 5519.227308176858, 5560.916586251209, 5749.108888122348, 5777.422257774231, 5900.675462849542, 5906.025505791582, 5915.615484993505, 5857.092150716646, 5882.000059989812, 5905.055191169436, 5921.467067963861, 5977.103434484862, 5426.321709786277, 5456.017916774979, 5480.26016487773, 5488.56091512678, 5519.116941289414, 5790.71046447676, 5933.6736479493175, 5935.198748168942, 5964.671943043174, 5973.253343332083, 5784.50831679312, 5785.913211301834, 5792.189093526909, 5795.739191736382, 5801.477866991991, 5938.406159384027, 5941.910871336933, 5946.13781001761, 5948.434898684618, 5948.7323070461935, 5818.6217895836635, 5866.911996320058, 5912.852178695481, 5916.7041647918295, 5921.259842519685, 5901.291844978544, 5929.347771745104, 5936.257967754031, 5939.376365481562, 5939.821805345847, 4392.956070439319, 4488.989977255157, 4512.300593408027, 4512.909741805145, 4549.181147393501, 3905.1018265799025, 3925.097227637659, 3977.6817854571564, 3983.6813054956115, 3986.9601303986587, 5571.0, 5595.888082238333, 5634.52106570946, 5650.802221922213, 5661.858453538694, 5789.768409263666, 5943.58394912352, 5954.970225148846, 5957.582969192202, 5963.165156878041, 5529.778808847682, 5586.329640443173, 5595.076812326002, 5604.8318550443555, 5617.185508101303, 4950.034743225108, 4954.5540901319055, 5007.973365460072, 5032.6980381177245, 5075.543201111844, 6160.445559899541, 6168.691565421711, 6170.10533472644, 6170.352113028068, 6172.9074063889075, 5819.70901454934, 5931.940680593311, 5968.641881487125, 5982.162497250475, 5992.101184822312, 6018.247719035121, 6037.667928263988, 6099.603525770811, 6126.938730612816, 6139.4781443577795, 5806.970965145316, 5842.298924129132, 5848.181254624271, 5858.619189752652, 5859.062549992152, 5804.419558044331, 5882.676452794966, 5889.49939255151, 5941.465268125889, 5951.196588460502, 5739.426057394227, 5803.0424979879535, 5806.767729290781, 5818.0, 5845.824625261249, 5812.18629391877, 5821.126830975219, 5825.621334613236, 5826.475617194473, 5831.125331200354, 5586.832395027993, 5623.128415095667, 5644.9435505644415, 5722.542196624343, 5734.311882574118, 5711.543076553949, 5769.9711501442225, 5786.132080188006, 5793.913091303718, 5834.912476312774, 5605.887882242251, 5655.660660360391, 5662.8301150965535, 5664.716764161858, 5665.603407761417], "value": 5395.675077011633, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [583.1282233061573, 584.2784161560469, 605.8697380063287, 617.870247248078, 621.9657918814466, 41995.0, 42432.15135697284, 42639.0, 42757.358639620354, 45786.0, 43686.12627747443, 44143.0, 44160.3375949361, 44290.557094429045, 44450.33324500135, 8840.336974726904, 9057.682981095662, 9060.909390906072, 9062.139096785828, 9081.364304498687, 8866.601002954883, 8905.77735556613, 8909.910900890973, 8978.730638080868, 8979.371443998923, 8963.551822408886, 8998.59506322217, 9006.504642244674, 9015.188633023026, 9030.954845225764, 8916.821663566725, 8940.64237430502, 8980.685676001342, 8985.101489850962, 8989.056149104315, 8875.556222188929, 8885.600147993357, 8910.955445222733, 8966.910330896739, 8973.910260897437, 42051.0, 42377.36433953493, 42422.78788606068, 42443.15113697709, 42537.14925701469, 3455.2571197192724, 3546.7517273790586, 3580.2660454606744, 3592.46113083037, 3667.651573100551, 31722.682773172204, 32059.198520037186, 32168.356632867213, 32208.83895580507, 32312.83843580767, 4240.0, 4310.655147588185, 4317.222899878021, 4345.478542574911, 4391.143726973241, 358911.0, 361063.0, 362374.0, 362904.0, 363070.0, 34230.14424639354, 35034.474482882775, 59351.406485935455, 59367.703161483914, 59542.0, 35877.82061089678, 36032.81983590065, 36033.45949810755, 36164.81917590448, 36166.63833361685, 14900.254987250593, 14992.400303987937, 15004.24978751058, 15012.099274043374, 15039.624009399633, 13053.34733263333, 13074.869251307366, 13085.672858178432, 13101.148425352321, 13118.409671564803, 8079.474834135763, 8168.877466838002, 8176.059753128347, 8224.506529608243, 8269.46248493846, 3169.6988786065285, 3185.8088514689193, 3188.314512379803, 3194.9296985510114, 3207.1821685470054, 1046.3355769086534, 1053.8155822730992, 1072.9302595331278, 1089.6458650938478, 1139.4758411130806, 33856.0, 34176.316473670384, 34720.0, 36724.7632931484, 36762.44856327157, 1112.7830073135822, 1134.9773004540027, 1145.851039364894, 1157.8379026936236, 1217.4582310871576, 17214.569635758955, 17536.64926701459, 17646.91176544109, 17661.558461038578, 17666.205020774098, 562624.0, 569315.0, 571556.0, 572287.0, 573892.0, 57266.0, 57295.713521432124, 57455.0, 57974.130388044214, 58148.4185158143, 1354.4514471639002, 1357.9796303055462, 1394.539801865382, 1394.6583087143513, 1400.369833574875, 31125.0, 32192.67807321897, 32617.836910815295, 32658.346833063682, 33004.50493242651, 51720.89674619535, 52408.47591524036, 52620.21069683881, 52718.47281527136, 53072.73463632657, 477518.0, 477708.0, 478929.0, 479469.0, 481026.0, 27591.724082758916, 27646.170614881587, 27669.584956226074, 27985.300367490163, 28015.859920700266, 46908.29637555507, 47756.5224347766, 47858.28212576884, 47950.28074578814, 48616.75691621519, 41067.0, 41615.7919210402, 41651.084424090026, 42539.361909572, 42613.5738642622, 40624.79687601661, 40646.59353406546, 40678.79660601678, 41162.38256426096, 41220.0, 41433.0, 41964.790176048926, 42455.0, 42634.0, 44138.83301792303, 35768.46347304845, 36797.81601091977, 37199.628003720696, 37606.2478750418, 37786.05534861651, 29361.265968350963, 29415.26461838471, 29419.705802941695, 29532.0, 29552.852235738683], "value": 19130.661881732245, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [380.3666894620457, 384.298920671797, 393.45506473534147, 393.5061497820235, 402.23775944585014, 14188.148711077343, 18995.905020474896, 19796.10917508712, 20626.38120856373, 20686.793132068695, 18839.24643014281, 19002.14490347934, 19209.32767353143, 20013.399598012045, 20019.799802001977, 5564.582656300783, 5745.166950792132, 7039.612821294827, 7397.075365579302, 7408.259174082603, 7312.488125831194, 7377.0, 7401.925980740178, 7438.442116841232, 7445.516041457315, 7360.926390736077, 7487.288707572772, 7492.550446973171, 7498.887516687254, 7626.466147369686, 7653.885191722128, 7664.655090520884, 7778.844423111563, 7781.961090194541, 7801.0, 7415.88876166858, 7429.925700742978, 7445.813854653677, 7453.701851925916, 7454.813629659247, 26335.0, 27245.72754272452, 28017.0, 28325.433491330263, 28650.713492865012, 2543.4785868896834, 2730.986345068282, 3247.723943464808, 3316.8507417166284, 3446.362422951737, 16188.0, 16230.83769162305, 16406.195318514954, 16982.915085424618, 17193.39823106198, 2169.642009068502, 2287.3138058582526, 2377.6314671225987, 2419.9727355045397, 2430.5746494363416, 88396.0, 100753.9924600752, 101334.49332753362, 102700.0, 104989.0, 17895.910520447316, 18002.819971800378, 18243.63512729738, 18389.63220735578, 18525.629487410446, 30799.384012319628, 32252.516212256836, 32413.35173296521, 32484.187895302333, 32506.34987300288, 9818.0, 9834.950825245827, 9932.900670993198, 9989.850152247722, 10015.549300281506, 8136.14570470104, 8161.5919204039565, 8211.507309561446, 8332.33341332692, 8378.24595786382, 8673.306135509145, 8730.519821409756, 8745.781355466037, 8776.385653004229, 9110.134537218953, 3496.6852983231124, 3505.211327451354, 3559.839807208682, 3601.7658852174527, 3624.8912532624063, 392.1118666220955, 397.7851959941599, 409.21635068843426, 916.3173435790245, 1043.5251960358019, 11343.659690209306, 11547.364894930692, 11592.246503977214, 11659.358735269641, 11806.996405305474, 418.5187034909878, 424.37616703445883, 428.41521323393346, 439.08450879915097, 446.72303172032895, 5971.581989260797, 6066.757329706762, 6073.301570319381, 6090.0, 6178.567500275028, 184552.0, 184857.0, 186645.0, 187106.0, 187532.0, 77690.6115469419, 87216.5113395457, 89257.0, 92590.53704731433, 95502.0, 454.97725113744843, 462.7524274513119, 463.25184826505625, 466.29822117712627, 466.442601091699, 11388.544458221579, 11723.120765942418, 11829.290242585472, 11964.64106076819, 12071.215371000857, 42054.789726051175, 42428.787856061754, 43186.35220471633, 44212.0, 44473.55526444824, 61771.691141544004, 62020.689896550226, 62773.0, 66100.33899660943, 66476.66761666161, 8464.957675211585, 8615.91384086151, 8683.523800953979, 8801.427907186013, 8825.514596697243, 9129.406588571721, 10949.288296260718, 11744.706382340168, 12713.745725085262, 12924.353782310658, 11328.150388720715, 11457.083433325148, 11491.712707182052, 11686.415679215836, 11861.406929653655, 11138.10895128404, 11155.382469541708, 11270.774584508099, 11376.94311528437, 11559.826602601135, 11358.829617555579, 11480.712982175179, 11550.826737598774, 11622.6513204604, 11885.76228475443, 7447.32974032318, 7823.178566250462, 8587.441816281922, 8860.601272942604, 8987.146221108984, 10421.114205292635, 10941.617043403443, 11178.105751539695, 11203.663890083311, 11258.943705281421], "value": 9377.03902511552, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1488.2335597167457, 1502.4065494129818, 1646.6953613581481, 1793.8833975791565, 1806.7922188948266, 7984.243466437389, 8653.350998675101, 8728.47629142252, 9241.353105282624, 9271.304652151082, 8733.519656418894, 9051.275897928166, 9084.591193396296, 9116.635334586608, 9128.771780705485, 2306.642470417084, 2321.791038806507, 2324.5931961906686, 2338.1232037985756, 2350.0, 2301.3326135420707, 2320.0487800002, 2323.628219484874, 2333.369990102671, 2353.2587235020915, 2320.5010922651627, 2322.628379459287, 2335.2877372401413, 2336.065573770497, 2336.2991102669216, 2295.632698768206, 2298.138198175684, 2306.250468597704, 2308.272894038381, 2319.605667036608, 2261.5929132756096, 2266.4220623741007, 2272.0798076778933, 2284.120613563773, 2294.977050229493, 9040.593173307218, 9119.0, 9124.680636177769, 9193.632254709804, 9209.263258939269, 5215.817446389358, 5348.037353276409, 5373.623846330719, 5389.568834493231, 5390.164524498709, 3270.787398819069, 3379.7509347307614, 3471.3057388522398, 3488.9127771805656, 3534.9116272093147, 1018.6842078955474, 1038.7662775875442, 1043.6712435582767, 1051.0488008352454, 1064.8455973883742, 12622.68443288916, 12636.989040876708, 12689.302088385135, 12708.555200568027, 12766.489340426464, 4483.663725220556, 4492.640588752892, 4634.328022436728, 4646.256598944153, 4706.458757242893, 10704.1436685065, 10717.0890474309, 10725.785484290427, 10753.83869241962, 10763.730906727238, 5242.082635538765, 5284.180951952453, 5289.18017707256, 5291.1798671206025, 5293.0, 4445.933311000337, 4791.377120974251, 4870.707757534559, 4952.8113252819785, 4963.6277279204205, 3883.708721845873, 3900.941485877714, 3978.085040440657, 4020.577839326887, 4095.2014357200655, 1250.6185613387822, 1260.4013093780563, 1265.4811527273773, 1269.428757059327, 1282.730626568431, 1032.4682788363998, 1041.4376236832177, 1043.415687215162, 1048.449563978902, 1054.599252284127, 5991.820245392558, 6290.4653104485715, 6304.148939893147, 6488.805335839932, 6559.36015996001, 978.3836183204536, 1003.3678782367208, 1008.3042700536606, 1026.820306446369, 1027.1320733979776, 4245.87262382129, 4504.9099018020115, 4524.208263553931, 4531.365608814768, 4536.251518499476, 10543.0, 10661.893381066246, 10726.624568140078, 10775.515101820436, 10783.946080269705, 10029.749256268651, 10306.845397319046, 10612.416317102634, 10619.991100845407, 10684.358938463716, 7975.481593696391, 8035.879461808077, 8039.155888631726, 8066.919330806617, 8085.272325490734, 6294.559380843297, 6546.738130474918, 6615.933840661532, 6647.235567909753, 6658.1344425224415, 9274.860877086714, 10549.997750213717, 10652.348885922695, 10746.0, 10746.355218686904, 9723.9027609723, 9837.409755414697, 9928.007199280015, 9985.400875947467, 10045.347052441568, 7032.964835175791, 7731.38148948094, 7799.6100194988885, 7927.682892684228, 7947.801304967422, 8820.64717411322, 8824.5587720615, 8861.202491775772, 8867.113288671082, 8926.464412135292, 7806.687732490636, 7806.843863122819, 7881.093674227308, 7898.802529936797, 8076.919230807852, 7903.091144518224, 7947.165547617417, 7995.680172793023, 8054.4361894669155, 8054.597270136587, 7366.226546212571, 7398.482106252511, 7457.179710231979, 7493.737719180021, 7498.662560184914, 5393.40672526014, 5431.022415965006, 5463.180522921593, 5464.1257398816, 5473.343198816008, 5477.808276710296, 5484.424135465719, 5547.639403438763, 5590.776368945197, 5658.858528536654], "value": 4738.798590793162, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [307.1384765732122, 307.2549068508865, 311.9500879859223, 312.06225292994554, 314.5627577667042, 5681.358168451674, 5708.08670612702, 5720.971395143024, 5742.885142297151, 5743.712814359286, 5562.749676264568, 5564.720114373697, 5584.664920104787, 5616.66300021999, 5662.688552129631, 4141.420201171831, 4152.584741525839, 4307.784610769449, 4331.783410829462, 4356.455443069616, 4302.913941721164, 4323.805428755713, 4344.956550434503, 4355.390245365651, 4369.388285640013, 4315.136972605475, 4330.523642399334, 4332.631726303268, 4337.284348082562, 4344.131173765244, 4189.183109293689, 4276.3799249109015, 4326.502452218004, 4332.1119170569955, 4357.84747533838, 3809.2191100824266, 3819.6371344722206, 3824.5275568905895, 3838.136419305662, 3841.2125514269787, 5519.834404967857, 5531.363893152299, 5545.334559852843, 5546.55627549795, 5566.693831839248, 4894.583960363373, 4961.131801934647, 4984.850454486371, 4985.576226020793, 4992.625553083533, 5862.912056319158, 5886.23478947734, 5900.557458190653, 5926.111083337534, 5927.577381428469, 4197.9370309445385, 4199.0, 4204.348326009474, 4207.389928460387, 4208.579142085798, 6037.818865434044, 6109.114178444145, 6130.417610327012, 6159.29168145669, 6178.907316390258, 4265.189613973335, 4274.653484152482, 4287.656987440997, 4289.378040184156, 4299.634531064832, 4280.935785963213, 4316.1583491219535, 4318.157959197926, 4321.891952701145, 4338.175746608197, 4852.0, 4916.459189489154, 4921.9015619688125, 4931.432885218174, 4981.850544483671, 5935.584509084322, 5947.910781338283, 5964.343922168558, 5969.940300597025, 5995.52035837132, 1468.4713503138862, 1494.6039299585618, 1500.2348802111003, 1505.954821355361, 1512.9470468533768, 925.708401853414, 955.6368579939578, 966.1015255812163, 969.781799095212, 977.4330888084894, 5691.800786972519, 5696.860627874442, 5737.77048918047, 5742.827715168552, 5781.624194427349, 6083.969580152071, 6093.664848433379, 6136.693165341715, 6156.353582873823, 6162.352952939877, 5630.18362337467, 5631.182886615381, 5671.234383358276, 5734.512566431817, 5736.942630573641, 3236.579244698174, 3236.919077023046, 3238.2390138317946, 3245.772795904264, 3252.9349413011605, 6103.6032657877095, 6179.0422484514975, 6194.938050619527, 6214.2542894852, 6245.156903818017, 6163.0, 6174.209479250967, 6242.968785156136, 6248.375162483806, 6267.874642507124, 5926.585139040312, 6219.782307619212, 6243.781467648701, 6261.8747625047245, 6303.46420554258, 5976.312724036791, 6015.789447369321, 6038.305594856648, 6042.585938944482, 6090.23872015998, 5988.640681559121, 6036.098628931873, 6048.183495228088, 6048.455638992512, 6063.878722425615, 5939.732712027882, 6199.442050215503, 6214.533909956862, 6252.531060170414, 6273.341299163704, 4155.605217504332, 4163.396307535451, 4163.708540402143, 4167.437395951508, 4182.895427614334, 5921.230240068763, 5989.670568118795, 6016.969915150396, 6057.333693293822, 6080.361562035922, 5750.396208398225, 5841.649501029951, 5843.0, 5859.5019423349495, 5960.672163031075, 5916.0477042574985, 5936.0, 5937.139114828412, 5949.7802950395935, 5965.970170149121, 5259.658122222043, 5756.280464941882, 5814.796482123105, 5829.562782791223, 5881.941180588139, 5930.309861689398, 5959.195508606283, 5987.700614969322, 6022.608530445507, 6030.30651475086, 5614.0, 5840.10914597277, 5855.2973643163095, 5881.411858814085, 5894.970525147347], "value": 4469.2042919619835, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [739.781764379508, 768.7117331000875, 792.6868886789715, 823.5347028928655, 866.6446756829697, 15165.317560709767, 15638.06171629703, 15649.45226917058, 15649.608759780996, 15682.921585392085, 14667.339969701363, 14767.483138090169, 14860.851391486081, 15760.369585216578, 16241.431549895757, 801.6913488307, 818.1368656067846, 822.8477731619639, 823.4853216739538, 824.4023083264645, 804.1315379390273, 830.2776584371575, 830.3689196210893, 842.296682270305, 843.0389356134012, 856.5117882806802, 858.6479543387212, 859.5315553023618, 860.0883063952231, 861.5089399042548, 848.0459483081534, 850.7320194138857, 854.6624083486988, 855.6278019061729, 857.2028013947026, 619.1764952613058, 621.4686443091138, 622.4024936061387, 622.8380621038517, 623.323693792236, 15000.049993500885, 15054.0, 15145.394184232617, 15163.393464261417, 15195.848041519665, 15111.0, 15200.695986080327, 15211.543653690407, 15258.313375898111, 15360.769588456182, 12489.75020499594, 12861.16402433848, 12910.450745910457, 12954.222746635232, 12987.740245195044, 3901.43429202764, 3949.9012524686827, 3964.682825373963, 3968.5436174839974, 4075.042365044212, 80517.59741201316, 80990.59504702498, 81014.59492702498, 81136.0, 85499.14500854973, 11124.489037532516, 11262.493187806569, 11700.473478693479, 11932.940335298441, 11977.461014254379, 19540.0, 19584.51038724015, 19604.901975490033, 19649.705254421195, 19691.901540492494, 8049.6377663005305, 8253.669853205925, 8426.41015128935, 8569.143085691381, 8720.95639521811, 4795.688280261772, 4875.634327425386, 4899.877503062381, 4989.625778066659, 5000.024995125988, 3518.9296214075575, 3633.745637805381, 3634.672879440863, 3639.8726044588843, 3640.12636967126, 604.1013745280476, 610.2128254551578, 610.3652201710261, 616.0420546050934, 618.2766163588612, 746.1121265693915, 765.9080910290801, 766.8082979255187, 776.825214326772, 776.9533827970226, 9944.558039084437, 9983.700488985342, 10082.445465499468, 10356.844647330296, 10385.896141038493, 636.9331220221902, 643.8579730913114, 732.5641243460133, 763.6220071064859, 788.4599049650893, 4557.453105627346, 4675.392199014106, 4688.882777930579, 4690.6012988895645, 4765.404324459442, 119212.0, 119649.0, 120884.0, 121888.0, 123005.38497307456, 99020.5048974765, 100522.4973875126, 101384.49307753413, 101635.49182254041, 101727.0, 87325.563372184, 88880.55559722289, 89249.0, 89459.0, 90600.5469972646, 9139.405938614234, 9187.219086377732, 9207.769805754642, 9220.26237900953, 9304.116108969638, 53989.460105398444, 55350.0, 55354.72322638361, 56442.7177864108, 57610.71194644, 78124.0, 79940.20059799327, 80918.19081809343, 81360.59319703364, 81363.59318203371, 11640.35978021217, 11661.825072623747, 11971.76056478883, 11974.161808673309, 12285.93857030745, 13120.0, 13694.65763355924, 13848.169109853037, 13924.791128132883, 14065.437382504586, 11531.827022594836, 11872.347020913932, 11954.163208575315, 12001.939990299992, 12027.21823081497, 12408.317542535247, 12781.297028663514, 12783.80824287655, 13138.343082845628, 13518.188908665512, 12996.285204313854, 13104.868951310746, 13145.802812957621, 13302.201867887958, 13554.390052447467, 11663.88336116662, 11738.652269545953, 11781.52873885035, 12309.0, 12567.874321257035, 12141.75716485683, 12161.695957600778, 12288.50845966187, 12611.30637814929, 12694.301813400352], "value": 7659.527966645475, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1531.1, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 114.0, 106.0, 112.0, 113.0, 112.0, 113.0, 112.0, 112.0, 111.0], "value": 110.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 125.0, 144.0, 178.0, 118.0, 148.0, 149.0, 118.0, 179.0, 127.0], "value": 144.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 161.0, 161.0, 164.0, 163.0, 168.0, 166.0, 164.0, 164.0], "value": 163.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 75.0, 174.0, 76.0, 74.0, 74.0, 75.0, 159.0, 76.0], "value": 93.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 148.0, 85.0, 84.0, 84.0, 149.0, 84.0, 84.0, 146.0], "value": 103.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 117.0, 116.0, 118.0, 117.0, 117.0, 118.0, 117.0], "value": 117.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 147.0, 147.0, 149.0, 148.0, 147.0, 146.0, 146.0, 147.0], "value": 147.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 97.0, 96.0, 95.0, 95.0, 95.0, 95.0, 97.0, 96.0, 96.0], "value": 95.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 55.0, 55.0, 55.0, 56.0, 55.0, 55.0, 55.0, 54.0, 54.0], "value": 55.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 64.0, 63.0, 64.0, 63.0, 62.0, 63.0, 64.0, 65.0, 66.0], "value": 63.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 78.0, 77.0, 76.0, 75.0, 83.0, 76.0, 85.0, 77.0], "value": 78.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [127.0, 127.0, 130.0, 123.0, 123.0, 121.0, 137.0, 127.0, 158.0, 130.0], "value": 130.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 160.0, 168.0, 163.0, 162.0, 158.0, 158.0, 171.0, 165.0, 160.0], "value": 162.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 76.0, 65.0, 64.0, 69.0, 63.0, 63.0, 63.0, 64.0, 69.0], "value": 66.0, "unit": "score"}]}]} 12:16:19 INFO - Return code: 0 12:16:19 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 12:16:19 ERROR - # TBPL SUCCESS # 12:16:19 INFO - Running post-action listener: _resource_record_post_action 12:16:19 INFO - ##### 12:16:19 INFO - ##### Finished run-tests step (success) 12:16:19 INFO - ##### 12:16:19 INFO - Running post-run listener: _resource_record_post_run 12:16:19 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 0; Write bytes: 553558016; Read time: 0; Write time: 425084 12:16:19 INFO - TinderboxPrint: CPU usage
13.3% 12:16:19 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 12:16:19 INFO - TinderboxPrint: I/O write bytes / time
553,558,016 / 425,084 12:16:19 INFO - TinderboxPrint: CPU idle
8,230.4 (86.7%) 12:16:19 INFO - TinderboxPrint: CPU user
1,210.3 (12.7%) 12:16:19 INFO - TinderboxPrint: Swap in / out
0 / 0 12:16:19 INFO - install - Wall time: 18s; CPU: 14.0%; Read bytes: 0; Write bytes: 257306624; Read time: 0; Write time: 263296 12:16:19 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 0; Write bytes: 296251392; Read time: 0; Write time: 161788 12:16:20 INFO - Running post-run listener: _upload_blobber_files 12:16:20 INFO - Blob upload gear active. 12:16:20 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:16:20 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 12:16:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 12:16:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 12:16:20 INFO - (blobuploader) - INFO - Open directory for files ... 12:16:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 12:16:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:16:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:16:21 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 12:16:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:16:21 INFO - (blobuploader) - INFO - Done attempting. 12:16:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 12:16:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:16:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:16:21 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 12:16:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:16:21 INFO - (blobuploader) - INFO - Done attempting. 12:16:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 12:16:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:16:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:16:25 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 12:16:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:16:25 INFO - (blobuploader) - INFO - Done attempting. 12:16:25 INFO - (blobuploader) - INFO - Iteration through files over. 12:16:25 INFO - Return code: 0 12:16:25 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:16:25 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:16:25 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0b63291f8186cb465ffd90304935ceb3e45ae0fab03cc56edb22321b6af4821a65481914f9b2f14305dd3d21444b6dee5ae8ed855d56f49669b2ce884a613dba", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/33dfe5b8d3e7fd382803bb8c5a79878ce49032011c1d5d267f09fa5d765e09e43f5059cb7b05d4d015e64b4324379a7015146a31a4f654b9847f11f3b5a01696", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/e0434ba69f49c8ff50f1f42f8dde9d8a0e3e9bad4b9523ef6ed839030d0fccb3bc0ba91a8f94c3a85a289d482a3aae8912af93de5efeb62938f58eb0a40b48cf"} 12:16:25 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:16:25 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:16:25 INFO - Contents: 12:16:25 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0b63291f8186cb465ffd90304935ceb3e45ae0fab03cc56edb22321b6af4821a65481914f9b2f14305dd3d21444b6dee5ae8ed855d56f49669b2ce884a613dba", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/33dfe5b8d3e7fd382803bb8c5a79878ce49032011c1d5d267f09fa5d765e09e43f5059cb7b05d4d015e64b4324379a7015146a31a4f654b9847f11f3b5a01696", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/e0434ba69f49c8ff50f1f42f8dde9d8a0e3e9bad4b9523ef6ed839030d0fccb3bc0ba91a8f94c3a85a289d482a3aae8912af93de5efeb62938f58eb0a40b48cf"} 12:16:25 INFO - Running post-run listener: copy_logs_to_upload_dir 12:16:25 INFO - Copying logs to upload dir... 12:16:25 INFO - mkdir: /builds/slave/test/build/upload/logs 12:16:25 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1228.002590 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 28 secs) (at 2016-07-15 12:16:25.510560) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-15 12:16:25.513812) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0b63291f8186cb465ffd90304935ceb3e45ae0fab03cc56edb22321b6af4821a65481914f9b2f14305dd3d21444b6dee5ae8ed855d56f49669b2ce884a613dba", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/33dfe5b8d3e7fd382803bb8c5a79878ce49032011c1d5d267f09fa5d765e09e43f5059cb7b05d4d015e64b4324379a7015146a31a4f654b9847f11f3b5a01696", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/e0434ba69f49c8ff50f1f42f8dde9d8a0e3e9bad4b9523ef6ed839030d0fccb3bc0ba91a8f94c3a85a289d482a3aae8912af93de5efeb62938f58eb0a40b48cf"} build_url:https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011512 build_url: 'https://queue.taskcluster.net/v1/task/B888eZ8qRBWKmMbDJFEmLw/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/Mozilla-Inbound/sha512/0b63291f8186cb465ffd90304935ceb3e45ae0fab03cc56edb22321b6af4821a65481914f9b2f14305dd3d21444b6dee5ae8ed855d56f49669b2ce884a613dba", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/33dfe5b8d3e7fd382803bb8c5a79878ce49032011c1d5d267f09fa5d765e09e43f5059cb7b05d4d015e64b4324379a7015146a31a4f654b9847f11f3b5a01696", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/e0434ba69f49c8ff50f1f42f8dde9d8a0e3e9bad4b9523ef6ed839030d0fccb3bc0ba91a8f94c3a85a289d482a3aae8912af93de5efeb62938f58eb0a40b48cf"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-15 12:16:25.545410) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:16:25.546011) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1468608954.711787-1966110893 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004489 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:16:25.628888) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-15 12:16:25.629530) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-15 12:16:25.630177) ========= ========= Total master_lag: 0.19 =========