builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-052 starttime: 1467267020.55 results: success (0) buildid: 20160629222829 builduid: 6da8f673e6ef4f329643d4ff76b42c75 revision: dc96e5ff02fd23198a2b7f7a4c93a86a77c760c3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:20.554679) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:20.555412) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:20.555710) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:20.571661) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:20.572069) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-29 23:10:21-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 50.9M=0s 2016-06-29 23:10:21 (50.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.092424 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:20.680930) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:20.681356) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019261 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:20.731496) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-06-29 23:10:20.731882) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev dc96e5ff02fd23198a2b7f7a4c93a86a77c760c3 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev dc96e5ff02fd23198a2b7f7a4c93a86a77c760c3 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-29 23:10:21,253 truncating revision to first 12 chars 2016-06-29 23:10:21,253 Setting DEBUG logging. 2016-06-29 23:10:21,253 attempt 1/10 2016-06-29 23:10:21,253 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/dc96e5ff02fd?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-29 23:10:22,077 unpacking tar archive at: fx-team-dc96e5ff02fd/testing/mozharness/ program finished with exit code 0 elapsedTime=1.169879 ========= master_lag: 1.09 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-06-29 23:10:22.994536) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:22.994913) ========= script_repo_revision: dc96e5ff02fd23198a2b7f7a4c93a86a77c760c3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:22.996205) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:22.996510) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-29 23:10:23.013672) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-06-29 23:10:23.013935) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:10:23 INFO - MultiFileLogger online at 20160629 23:10:23 in /builds/slave/test 23:10:23 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 23:10:23 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 23:10:23 INFO - {'append_to_log': False, 23:10:23 INFO - 'base_work_dir': '/builds/slave/test', 23:10:23 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 23:10:23 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 23:10:23 INFO - 'branch': 'Fx-Team-Non-PGO', 23:10:23 INFO - 'buildbot_json_path': 'buildprops.json', 23:10:23 INFO - 'config_files': ('talos/linux_config.py',), 23:10:23 INFO - 'default_actions': ('clobber', 23:10:23 INFO - 'read-buildbot-config', 23:10:23 INFO - 'download-and-extract', 23:10:23 INFO - 'populate-webroot', 23:10:23 INFO - 'create-virtualenv', 23:10:23 INFO - 'install', 23:10:23 INFO - 'run-tests'), 23:10:23 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:10:23 INFO - 'download_minidump_stackwalk': True, 23:10:23 INFO - 'download_symbols': 'ondemand', 23:10:23 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:10:23 INFO - 'tooltool.py': '/tools/tooltool.py', 23:10:23 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:10:23 INFO - '/tools/misc-python/virtualenv.py')}, 23:10:23 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:10:23 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:10:23 INFO - 'installer_path': 'installer.exe', 23:10:23 INFO - 'log_level': 'info', 23:10:23 INFO - 'log_name': 'talos', 23:10:23 INFO - 'log_to_console': True, 23:10:23 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:10:23 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:10:23 INFO - 'opt_config_files': (), 23:10:23 INFO - 'pip_index': False, 23:10:23 INFO - 'sps_profile': False, 23:10:23 INFO - 'sps_profile_interval': 0, 23:10:23 INFO - 'suite': 'dromaeojs-e10s', 23:10:23 INFO - 'system_bits': '32', 23:10:23 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:10:23 INFO - 'title': 'talos-linux64-ix-052', 23:10:23 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:10:23 INFO - 'use_talos_json': True, 23:10:23 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 23:10:23 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:10:23 INFO - 'work_dir': 'build'} 23:10:23 INFO - ##### 23:10:23 INFO - ##### Running clobber step. 23:10:23 INFO - ##### 23:10:23 INFO - Running pre-action listener: _resource_record_pre_action 23:10:23 INFO - Running main action method: clobber 23:10:23 INFO - rmtree: /builds/slave/test/build 23:10:23 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 23:10:24 INFO - Running post-action listener: _resource_record_post_action 23:10:24 INFO - ##### 23:10:24 INFO - ##### Finished clobber step (success) 23:10:24 INFO - ##### 23:10:24 INFO - ##### 23:10:24 INFO - ##### Running read-buildbot-config step. 23:10:24 INFO - ##### 23:10:24 INFO - Running pre-action listener: _resource_record_pre_action 23:10:24 INFO - Running main action method: read_buildbot_config 23:10:24 INFO - Using buildbot properties: 23:10:24 INFO - { 23:10:24 INFO - "project": "", 23:10:24 INFO - "product": "firefox", 23:10:24 INFO - "script_repo_revision": "production", 23:10:24 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 23:10:24 INFO - "repository": "", 23:10:24 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 23:10:24 INFO - "buildid": "20160629222829", 23:10:24 INFO - "pgo_build": "False", 23:10:24 INFO - "basedir": "/builds/slave/test", 23:10:24 INFO - "buildnumber": 1449, 23:10:24 INFO - "slavename": "talos-linux64-ix-052", 23:10:24 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 23:10:24 INFO - "platform": "ubuntu64_hw", 23:10:24 INFO - "scheduler": "tests-fx-team-linux64-talos", 23:10:24 INFO - "branch": "fx-team", 23:10:24 INFO - "repo_path": "integration/fx-team", 23:10:24 INFO - "revision": "dc96e5ff02fd23198a2b7f7a4c93a86a77c760c3", 23:10:24 INFO - "stage_platform": "linux64", 23:10:24 INFO - "builduid": "6da8f673e6ef4f329643d4ff76b42c75", 23:10:24 INFO - "slavebuilddir": "test" 23:10:24 INFO - } 23:10:24 INFO - Found installer url https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 23:10:24 INFO - Running post-action listener: _resource_record_post_action 23:10:24 INFO - ##### 23:10:24 INFO - ##### Finished read-buildbot-config step (success) 23:10:24 INFO - ##### 23:10:24 INFO - ##### 23:10:24 INFO - ##### Running download-and-extract step. 23:10:24 INFO - ##### 23:10:24 INFO - Running pre-action listener: _resource_record_pre_action 23:10:24 INFO - Running main action method: download_and_extract 23:10:24 INFO - mkdir: /builds/slave/test/build/tests 23:10:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:24 INFO - https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 23:10:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 23:10:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 23:10:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:24 INFO - Downloaded 1361 bytes. 23:10:24 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 23:10:24 INFO - Using the following test package requirements: 23:10:24 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 23:10:24 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:10:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 23:10:24 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:10:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 23:10:24 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:10:24 INFO - u'jsshell-linux-x86_64.zip'], 23:10:24 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:10:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 23:10:24 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 23:10:24 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:10:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 23:10:24 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:10:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 23:10:24 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:10:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 23:10:24 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:10:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 23:10:24 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 23:10:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:24 INFO - https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:10:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 23:10:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 23:10:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:25 INFO - Downloaded 22701715 bytes. 23:10:25 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'] 23:10:25 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 23:10:27 INFO - Return code: 0 23:10:27 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 23:10:27 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')]} 23:10:27 INFO - https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:10:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 23:10:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 23:10:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:28 INFO - Downloaded 22701715 bytes. 23:10:28 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'] 23:10:28 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 23:10:29 INFO - Return code: 0 23:10: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')]} 23:10:29 INFO - https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 23:10:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 23:10:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 23:10:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:30 INFO - Downloaded 14405245 bytes. 23:10:30 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'] 23:10:30 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 23:10:30 INFO - Return code: 0 23:10:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:30 INFO - https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 23:10:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 23:10:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 23:10:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gg42XsY9QCKBuSzScWRmnA/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 23:10:32 INFO - Downloaded 56473666 bytes. 23:10:32 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 23:10:32 INFO - mkdir: /builds/slave/test/properties 23:10:32 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 23:10:32 INFO - Writing to file /builds/slave/test/properties/build_url 23:10:32 INFO - Contents: 23:10:32 INFO - build_url:https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 23:10:32 INFO - Running post-action listener: _resource_record_post_action 23:10:32 INFO - Running post-action listener: set_extra_try_arguments 23:10:32 INFO - ##### 23:10:32 INFO - ##### Finished download-and-extract step (success) 23:10:32 INFO - ##### 23:10:32 INFO - ##### 23:10:32 INFO - ##### Running populate-webroot step. 23:10:32 INFO - ##### 23:10:32 INFO - Running pre-action listener: _resource_record_pre_action 23:10:32 INFO - Running main action method: populate_webroot 23:10:32 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:10:32 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:10:32 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:10:32 INFO - '--tppagecycles', 23:10:32 INFO - '7'], 23:10:32 INFO - 'tests': ['tsvgm']}}, 23:10:32 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:10:32 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 23:10:32 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['dromaeo_css', 'kraken']}, 23:10:32 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 23:10:32 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:10:32 INFO - 'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:10:32 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:10:32 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:10:32 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:10:32 INFO - 'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['damp', 'tps']}, 23:10:32 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:10:32 INFO - 'tests': ['damp', 'tps']}, 23:10:32 INFO - 'g3': {'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['dromaeo_dom']}, 23:10:32 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 23:10:32 INFO - 'g4': {'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['basic_compositor_video']}, 23:10:32 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 23:10:32 INFO - 'other': {'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['a11yr', 23:10:32 INFO - 'ts_paint', 23:10:32 INFO - 'tpaint', 23:10:32 INFO - 'sessionrestore', 23:10:32 INFO - 'sessionrestore_no_auto_restore', 23:10:32 INFO - 'tabpaint']}, 23:10:32 INFO - 'other-e10s': {'tests': ['a11yr', 23:10:32 INFO - 'ts_paint', 23:10:32 INFO - 'tpaint', 23:10:32 INFO - 'sessionrestore', 23:10:32 INFO - 'sessionrestore_no_auto_restore', 23:10:32 INFO - 'tabpaint']}, 23:10:32 INFO - 'other-e10s_l64': {'tests': ['a11yr', 23:10:32 INFO - 'ts_paint', 23:10:32 INFO - 'tpaint', 23:10:32 INFO - 'sessionrestore', 23:10:32 INFO - 'sessionrestore_no_auto_restore', 23:10:32 INFO - 'tabpaint']}, 23:10:32 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 23:10:32 INFO - 'ts_paint', 23:10:32 INFO - 'tpaint', 23:10:32 INFO - 'sessionrestore', 23:10:32 INFO - 'sessionrestore_no_auto_restore', 23:10:32 INFO - 'tabpaint']}, 23:10:32 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['a11yr', 23:10:32 INFO - 'ts_paint', 23:10:32 INFO - 'tpaint', 23:10:32 INFO - 'sessionrestore', 23:10:32 INFO - 'sessionrestore_no_auto_restore', 23:10:32 INFO - 'tabpaint']}, 23:10:32 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['a11yr', 23:10:32 INFO - 'ts_paint', 23:10:32 INFO - 'tpaint', 23:10:32 INFO - 'sessionrestore', 23:10:32 INFO - 'sessionrestore_no_auto_restore', 23:10:32 INFO - 'tabpaint']}, 23:10:32 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['tsvgx', 23:10:32 INFO - 'tsvgr_opacity', 23:10:32 INFO - 'tart', 23:10:32 INFO - 'tscrollx', 23:10:32 INFO - 'cart']}, 23:10:32 INFO - 'svgr-e10s': {'tests': ['tsvgx', 23:10:32 INFO - 'tsvgr_opacity', 23:10:32 INFO - 'tart', 23:10:32 INFO - 'tscrollx', 23:10:32 INFO - 'cart']}, 23:10:32 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:10:32 INFO - 'talos_options': ['--disable-e10s'], 23:10:32 INFO - 'tests': ['tp5o']}, 23:10:32 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:10:32 INFO - 'tests': ['tp5o']}, 23:10:32 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:10:32 INFO - 'talos_options': ['--disable-e10s', 23:10:32 INFO - '--xperf_path', 23:10:32 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:10:32 INFO - 'tests': ['tp5n']}, 23:10:32 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:10:32 INFO - 'talos_options': ['--xperf_path', 23:10:32 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:10:32 INFO - 'tests': ['tp5n']}}, 23:10:32 INFO - 'talos.zip': {'path': '', 23:10:32 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:10:32 INFO - Running post-action listener: _resource_record_post_action 23:10:32 INFO - ##### 23:10:32 INFO - ##### Finished populate-webroot step (success) 23:10:32 INFO - ##### 23:10:32 INFO - ##### 23:10:32 INFO - ##### Running create-virtualenv step. 23:10:32 INFO - ##### 23:10:32 INFO - Running pre-action listener: _resource_record_pre_action 23:10:32 INFO - Running main action method: create_virtualenv 23:10:32 INFO - Creating virtualenv /builds/slave/test/build/venv 23:10:32 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 23:10:32 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 23:10:33 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:10:33 INFO - Using real prefix '/usr' 23:10:33 INFO - New python executable in /builds/slave/test/build/venv/bin/python 23:10:33 INFO - Installing distribute.............................................................................................................................................................................................done. 23:10:35 INFO - Installing pip.................done. 23:10:35 INFO - Return code: 0 23:10:35 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 23:10:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:35 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 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:35 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 23:10:35 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 23:10:35 INFO - Using env: {'DISPLAY': ':0', 23:10:35 INFO - 'HOME': '/home/cltbld', 23:10:35 INFO - 'LANG': 'en_US.UTF-8', 23:10:35 INFO - 'LANGUAGE': 'en_US:en', 23:10:35 INFO - 'LOGNAME': 'cltbld', 23:10:35 INFO - 'MAIL': '/var/mail/cltbld', 23:10:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:35 INFO - 'MOZ_NO_REMOTE': '1', 23:10:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:35 INFO - 'NO_EM_RESTART': '1', 23:10:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:35 INFO - 'PWD': '/builds/slave/test', 23:10:35 INFO - 'SHELL': '/bin/bash', 23:10:35 INFO - 'SHLVL': '1', 23:10:35 INFO - 'TERM': 'linux', 23:10:35 INFO - 'TMOUT': '86400', 23:10:35 INFO - 'USER': 'cltbld', 23:10:35 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:35 INFO - '_': '/tools/buildbot/bin/python'} 23:10:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:35 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 23:10:35 INFO - Cleaning up... 23:10:35 INFO - Return code: 0 23:10:35 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 23:10:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:35 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 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:35 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 23:10:35 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 23:10:35 INFO - Using env: {'DISPLAY': ':0', 23:10:35 INFO - 'HOME': '/home/cltbld', 23:10:35 INFO - 'LANG': 'en_US.UTF-8', 23:10:35 INFO - 'LANGUAGE': 'en_US:en', 23:10:35 INFO - 'LOGNAME': 'cltbld', 23:10:35 INFO - 'MAIL': '/var/mail/cltbld', 23:10:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:35 INFO - 'MOZ_NO_REMOTE': '1', 23:10:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:35 INFO - 'NO_EM_RESTART': '1', 23:10:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:35 INFO - 'PWD': '/builds/slave/test', 23:10:35 INFO - 'SHELL': '/bin/bash', 23:10:35 INFO - 'SHLVL': '1', 23:10:35 INFO - 'TERM': 'linux', 23:10:35 INFO - 'TMOUT': '86400', 23:10:35 INFO - 'USER': 'cltbld', 23:10:35 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:35 INFO - '_': '/tools/buildbot/bin/python'} 23:10:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:35 INFO - Downloading/unpacking psutil>=3.1.1 23:10:35 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 23:10:35 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 23:10:35 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 23:10:35 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 23:10:35 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 23:10:35 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 23:10:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 23:10:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:10:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:10:37 INFO - Installing collected packages: psutil 23:10:37 INFO - Running setup.py install for psutil 23:10:38 INFO - building 'psutil._psutil_linux' extension 23:10:38 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 23:10:38 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 23:10:38 INFO - building 'psutil._psutil_posix' extension 23:10:38 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 23:10:38 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 23:10:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:10:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:10:38 INFO - Successfully installed psutil 23:10:38 INFO - Cleaning up... 23:10:38 INFO - Return code: 0 23:10:38 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 23:10:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 23:10:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 23:10:38 INFO - Using env: {'DISPLAY': ':0', 23:10:38 INFO - 'HOME': '/home/cltbld', 23:10:38 INFO - 'LANG': 'en_US.UTF-8', 23:10:38 INFO - 'LANGUAGE': 'en_US:en', 23:10:38 INFO - 'LOGNAME': 'cltbld', 23:10:38 INFO - 'MAIL': '/var/mail/cltbld', 23:10:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:38 INFO - 'MOZ_NO_REMOTE': '1', 23:10:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:38 INFO - 'NO_EM_RESTART': '1', 23:10:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:38 INFO - 'PWD': '/builds/slave/test', 23:10:38 INFO - 'SHELL': '/bin/bash', 23:10:38 INFO - 'SHLVL': '1', 23:10:38 INFO - 'TERM': 'linux', 23:10:38 INFO - 'TMOUT': '86400', 23:10:38 INFO - 'USER': 'cltbld', 23:10:38 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:38 INFO - '_': '/tools/buildbot/bin/python'} 23:10:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:38 INFO - Downloading/unpacking mozsystemmonitor==0.3 23:10:38 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 23:10:38 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 23:10:38 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 23:10:38 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 23:10:38 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 23:10:38 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 23:10:40 INFO - Downloading mozsystemmonitor-0.3.tar.gz 23:10:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:10:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 23:10:40 INFO - Installing collected packages: mozsystemmonitor 23:10:40 INFO - Running setup.py install for mozsystemmonitor 23:10:40 INFO - Successfully installed mozsystemmonitor 23:10:40 INFO - Cleaning up... 23:10:40 INFO - Return code: 0 23:10:40 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 23:10:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:40 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 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:40 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 23:10:40 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 23:10:40 INFO - Using env: {'DISPLAY': ':0', 23:10:40 INFO - 'HOME': '/home/cltbld', 23:10:40 INFO - 'LANG': 'en_US.UTF-8', 23:10:40 INFO - 'LANGUAGE': 'en_US:en', 23:10:40 INFO - 'LOGNAME': 'cltbld', 23:10:40 INFO - 'MAIL': '/var/mail/cltbld', 23:10:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:40 INFO - 'MOZ_NO_REMOTE': '1', 23:10:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:40 INFO - 'NO_EM_RESTART': '1', 23:10:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:40 INFO - 'PWD': '/builds/slave/test', 23:10:40 INFO - 'SHELL': '/bin/bash', 23:10:40 INFO - 'SHLVL': '1', 23:10:40 INFO - 'TERM': 'linux', 23:10:40 INFO - 'TMOUT': '86400', 23:10:40 INFO - 'USER': 'cltbld', 23:10:40 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:40 INFO - '_': '/tools/buildbot/bin/python'} 23:10:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:40 INFO - Downloading/unpacking jsonschema==2.5.1 23:10:40 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 23:10:40 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 23:10:40 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 23:10:40 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 23:10:40 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 23:10:40 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 23:10:42 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:10:42 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 23:10:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:10:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:10:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:10:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:10:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:10:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:10:43 INFO - Downloading functools32-3.2.3-2.tar.gz 23:10:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 23:10:43 INFO - warning: no files found matching '*.txt' 23:10:43 INFO - no previously-included directories found matching 'build' 23:10:43 INFO - no previously-included directories found matching 'dist' 23:10:43 INFO - no previously-included directories found matching '.git*' 23:10:43 INFO - Installing collected packages: jsonschema, functools32 23:10:43 INFO - Running setup.py install for functools32 23:10:43 INFO - warning: no files found matching '*.txt' 23:10:43 INFO - no previously-included directories found matching 'build' 23:10:43 INFO - no previously-included directories found matching 'dist' 23:10:43 INFO - no previously-included directories found matching '.git*' 23:10:43 INFO - Successfully installed jsonschema functools32 23:10:43 INFO - Cleaning up... 23:10:43 INFO - Return code: 0 23:10:43 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 23:10:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:43 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 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:43 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 23:10:43 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 23:10:43 INFO - Using env: {'DISPLAY': ':0', 23:10:43 INFO - 'HOME': '/home/cltbld', 23:10:43 INFO - 'LANG': 'en_US.UTF-8', 23:10:43 INFO - 'LANGUAGE': 'en_US:en', 23:10:43 INFO - 'LOGNAME': 'cltbld', 23:10:43 INFO - 'MAIL': '/var/mail/cltbld', 23:10:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:43 INFO - 'MOZ_NO_REMOTE': '1', 23:10:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:43 INFO - 'NO_EM_RESTART': '1', 23:10:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:43 INFO - 'PWD': '/builds/slave/test', 23:10:43 INFO - 'SHELL': '/bin/bash', 23:10:43 INFO - 'SHLVL': '1', 23:10:43 INFO - 'TERM': 'linux', 23:10:43 INFO - 'TMOUT': '86400', 23:10:43 INFO - 'USER': 'cltbld', 23:10:43 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:43 INFO - '_': '/tools/buildbot/bin/python'} 23:10:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:43 INFO - Downloading/unpacking blobuploader==1.2.4 23:10:43 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 23:10:43 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 23:10:43 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 23:10:43 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 23:10:43 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 23:10:43 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 23:10:45 INFO - Downloading blobuploader-1.2.4.tar.gz 23:10:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:10:45 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:10:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:10:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:10:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:10:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:10:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:10:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:10:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 23:10:45 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:10:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:10:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:10:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:10:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:10:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:10:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:10:46 INFO - Downloading docopt-0.6.1.tar.gz 23:10:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 23:10:46 INFO - Installing collected packages: blobuploader, requests, docopt 23:10:46 INFO - Running setup.py install for blobuploader 23:10:46 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:10:46 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 23:10:46 INFO - Running setup.py install for requests 23:10:46 INFO - Running setup.py install for docopt 23:10:46 INFO - Successfully installed blobuploader requests docopt 23:10:46 INFO - Cleaning up... 23:10:46 INFO - Return code: 0 23:10:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:10: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')]} 23:10:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10: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')]} 23:10:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:46 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 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:46 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 23:10:46 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 23:10:46 INFO - Using env: {'DISPLAY': ':0', 23:10:46 INFO - 'HOME': '/home/cltbld', 23:10:46 INFO - 'LANG': 'en_US.UTF-8', 23:10:46 INFO - 'LANGUAGE': 'en_US:en', 23:10:46 INFO - 'LOGNAME': 'cltbld', 23:10:46 INFO - 'MAIL': '/var/mail/cltbld', 23:10:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:46 INFO - 'MOZ_NO_REMOTE': '1', 23:10:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:46 INFO - 'NO_EM_RESTART': '1', 23:10:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:46 INFO - 'PWD': '/builds/slave/test', 23:10:46 INFO - 'SHELL': '/bin/bash', 23:10:46 INFO - 'SHLVL': '1', 23:10:46 INFO - 'TERM': 'linux', 23:10:46 INFO - 'TMOUT': '86400', 23:10:46 INFO - 'USER': 'cltbld', 23:10:46 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:46 INFO - '_': '/tools/buildbot/bin/python'} 23:10:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:10:47 INFO - Running setup.py (path:/tmp/pip-e0Czyv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:10:47 INFO - Running setup.py (path:/tmp/pip-EANDvD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:10:47 INFO - Running setup.py (path:/tmp/pip-YwMdrr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:10:47 INFO - Running setup.py (path:/tmp/pip-RfC14m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:10:47 INFO - Running setup.py (path:/tmp/pip-JFXbFE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:10:47 INFO - Running setup.py (path:/tmp/pip-xYncW1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:10:47 INFO - Running setup.py (path:/tmp/pip-7MfN_c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:10:47 INFO - Running setup.py (path:/tmp/pip-syBJOZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:10:47 INFO - Running setup.py (path:/tmp/pip-FIb1Y4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:10:47 INFO - Running setup.py (path:/tmp/pip-MNJB6A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:10:47 INFO - Running setup.py (path:/tmp/pip-1eFV3N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:10:47 INFO - Running setup.py (path:/tmp/pip-mZc0Aa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:10:47 INFO - Running setup.py (path:/tmp/pip-QDtnSw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:10:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:10:47 INFO - Running setup.py (path:/tmp/pip-4yFNxO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:10:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:10:48 INFO - Running setup.py (path:/tmp/pip-MizuAa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:10:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:10:48 INFO - Running setup.py (path:/tmp/pip-O7KX4r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:10:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:10:48 INFO - Running setup.py (path:/tmp/pip-6rtYuV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:10:48 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:10:48 INFO - Running setup.py install for manifestparser 23:10:48 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 23:10:48 INFO - Running setup.py install for mozcrash 23:10:48 INFO - Running setup.py install for mozdebug 23:10:48 INFO - Running setup.py install for mozdevice 23:10:48 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 23:10:48 INFO - Installing dm script to /builds/slave/test/build/venv/bin 23:10:48 INFO - Running setup.py install for mozfile 23:10:48 INFO - Running setup.py install for mozhttpd 23:10:48 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 23:10:48 INFO - Running setup.py install for mozinfo 23:10:48 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 23:10:48 INFO - Running setup.py install for mozInstall 23:10:49 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Running setup.py install for mozleak 23:10:49 INFO - Running setup.py install for mozlog 23:10:49 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Running setup.py install for moznetwork 23:10:49 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Running setup.py install for mozprocess 23:10:49 INFO - Running setup.py install for mozprofile 23:10:49 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Running setup.py install for mozrunner 23:10:49 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 23:10:49 INFO - Running setup.py install for mozscreenshot 23:10:49 INFO - Running setup.py install for moztest 23:10:49 INFO - Running setup.py install for mozversion 23:10:50 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 23:10:50 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:10:50 INFO - Cleaning up... 23:10:50 INFO - Return code: 0 23:10:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:10:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:50 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 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:50 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 23:10:50 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 23:10:50 INFO - Using env: {'DISPLAY': ':0', 23:10:50 INFO - 'HOME': '/home/cltbld', 23:10:50 INFO - 'LANG': 'en_US.UTF-8', 23:10:50 INFO - 'LANGUAGE': 'en_US:en', 23:10:50 INFO - 'LOGNAME': 'cltbld', 23:10:50 INFO - 'MAIL': '/var/mail/cltbld', 23:10:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:50 INFO - 'MOZ_NO_REMOTE': '1', 23:10:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:50 INFO - 'NO_EM_RESTART': '1', 23:10:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:50 INFO - 'PWD': '/builds/slave/test', 23:10:50 INFO - 'SHELL': '/bin/bash', 23:10:50 INFO - 'SHLVL': '1', 23:10:50 INFO - 'TERM': 'linux', 23:10:50 INFO - 'TMOUT': '86400', 23:10:50 INFO - 'USER': 'cltbld', 23:10:50 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:50 INFO - '_': '/tools/buildbot/bin/python'} 23:10:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:10:50 INFO - Running setup.py (path:/tmp/pip-R1y5pg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:10:50 INFO - Running setup.py (path:/tmp/pip-AieRa5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:10:50 INFO - Running setup.py (path:/tmp/pip-7EjHh5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:10:50 INFO - Running setup.py (path:/tmp/pip-zSwJV6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:10:50 INFO - Running setup.py (path:/tmp/pip-dYaB1P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:10:50 INFO - Running setup.py (path:/tmp/pip-LRHo_v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:10:50 INFO - Running setup.py (path:/tmp/pip-6vxHqM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:10:50 INFO - Running setup.py (path:/tmp/pip-zh1K6s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:10:50 INFO - Running setup.py (path:/tmp/pip-2QQQEW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:10:50 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)) 23:10:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:10:50 INFO - Running setup.py (path:/tmp/pip-U8MqnE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:10:51 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)) 23:10:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:10:51 INFO - Running setup.py (path:/tmp/pip-v0Ganl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:10:51 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)) 23:10:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:10:51 INFO - Running setup.py (path:/tmp/pip-9n_WwH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:10:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 23:10:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:10:51 INFO - Running setup.py (path:/tmp/pip-g1j5s5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:10:51 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)) 23:10:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:10:51 INFO - Running setup.py (path:/tmp/pip-CLGcA0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:10:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 23:10:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:10:51 INFO - Running setup.py (path:/tmp/pip-3RAelg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:10:51 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)) 23:10:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:10:51 INFO - Running setup.py (path:/tmp/pip-UTHjYZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:10:51 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)) 23:10:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:10:51 INFO - Running setup.py (path:/tmp/pip-AYwwrK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:10:51 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)) 23:10:51 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)) 23:10:51 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)) 23:10:51 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)) 23:10:51 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)) 23:10:51 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)) 23:10:51 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 23:10:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:10:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:10:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:10:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:10:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:10:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:10:53 INFO - Downloading blessings-1.6.tar.gz 23:10:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 23:10:53 INFO - Installing collected packages: blessings 23:10:53 INFO - Running setup.py install for blessings 23:10:53 INFO - Successfully installed blessings 23:10:53 INFO - Cleaning up... 23:10:53 INFO - Return code: 0 23:10:53 INFO - Done creating virtualenv /builds/slave/test/build/venv. 23:10:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:10:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:10:53 INFO - Reading from file tmpfile_stdout 23:10:53 INFO - Current package versions: 23:10:53 INFO - argparse == 1.2.1 23:10:53 INFO - blessings == 1.6 23:10:53 INFO - blobuploader == 1.2.4 23:10:53 INFO - docopt == 0.6.1 23:10:53 INFO - functools32 == 3.2.3-2 23:10:53 INFO - jsonschema == 2.5.1 23:10:53 INFO - manifestparser == 1.1 23:10:53 INFO - mozInstall == 1.12 23:10:53 INFO - mozcrash == 0.17 23:10:53 INFO - mozdebug == 0.1 23:10:53 INFO - mozdevice == 0.48 23:10:53 INFO - mozfile == 1.2 23:10:53 INFO - mozhttpd == 0.7 23:10:53 INFO - mozinfo == 0.9 23:10:53 INFO - mozleak == 0.1 23:10:53 INFO - mozlog == 3.2 23:10:53 INFO - moznetwork == 0.27 23:10:53 INFO - mozprocess == 0.22 23:10:53 INFO - mozprofile == 0.28 23:10:53 INFO - mozrunner == 6.11 23:10:53 INFO - mozscreenshot == 0.1 23:10:53 INFO - mozsystemmonitor == 0.3 23:10:53 INFO - moztest == 0.7 23:10:53 INFO - mozversion == 1.4 23:10:53 INFO - psutil == 3.1.1 23:10:53 INFO - requests == 1.2.3 23:10:53 INFO - wsgiref == 0.1.2 23:10:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:10:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:53 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 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:53 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 23:10:53 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 23:10:53 INFO - Using env: {'DISPLAY': ':0', 23:10:53 INFO - 'HOME': '/home/cltbld', 23:10:53 INFO - 'LANG': 'en_US.UTF-8', 23:10:53 INFO - 'LANGUAGE': 'en_US:en', 23:10:53 INFO - 'LOGNAME': 'cltbld', 23:10:53 INFO - 'MAIL': '/var/mail/cltbld', 23:10:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:53 INFO - 'MOZ_NO_REMOTE': '1', 23:10:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:53 INFO - 'NO_EM_RESTART': '1', 23:10:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:53 INFO - 'PWD': '/builds/slave/test', 23:10:53 INFO - 'SHELL': '/bin/bash', 23:10:53 INFO - 'SHLVL': '1', 23:10:53 INFO - 'TERM': 'linux', 23:10:53 INFO - 'TMOUT': '86400', 23:10:53 INFO - 'USER': 'cltbld', 23:10:53 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:53 INFO - '_': '/tools/buildbot/bin/python'} 23:10:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 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)) 23:10:54 INFO - Cleaning up... 23:10:54 INFO - Return code: 0 23:10:54 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 23:10:54 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')]} 23:10:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:10:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:54 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')]} 23:10:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:10:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:10:54 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 0x2a8b030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cba400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', '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 23:10:54 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 23:10:54 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 23:10:54 INFO - Using env: {'DISPLAY': ':0', 23:10:54 INFO - 'HOME': '/home/cltbld', 23:10:54 INFO - 'LANG': 'en_US.UTF-8', 23:10:54 INFO - 'LANGUAGE': 'en_US:en', 23:10:54 INFO - 'LOGNAME': 'cltbld', 23:10:54 INFO - 'MAIL': '/var/mail/cltbld', 23:10:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:54 INFO - 'MOZ_NO_REMOTE': '1', 23:10:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:54 INFO - 'NO_EM_RESTART': '1', 23:10:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:10:54 INFO - 'PWD': '/builds/slave/test', 23:10:54 INFO - 'SHELL': '/bin/bash', 23:10:54 INFO - 'SHLVL': '1', 23:10:54 INFO - 'TERM': 'linux', 23:10:54 INFO - 'TMOUT': '86400', 23:10:54 INFO - 'USER': 'cltbld', 23:10:54 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:10:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:54 INFO - '_': '/tools/buildbot/bin/python'} 23:10:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:10:54 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 23:10:54 INFO - Cleaning up... 23:10:54 INFO - Return code: 0 23:10:54 INFO - Running post-action listener: _resource_record_post_action 23:10:54 INFO - Running post-action listener: _start_resource_monitoring 23:10:54 INFO - Starting resource monitoring. 23:10:54 INFO - ##### 23:10:54 INFO - ##### Finished create-virtualenv step (success) 23:10:54 INFO - ##### 23:10:54 INFO - ##### 23:10:54 INFO - ##### Running install step. 23:10:54 INFO - ##### 23:10:54 INFO - Running pre-action listener: _resource_record_pre_action 23:10:54 INFO - Running main action method: install 23:10:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:10:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:10:54 INFO - Reading from file tmpfile_stdout 23:10:54 INFO - Detecting whether we're running mozinstall >=1.0... 23:10:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 23:10:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 23:10:54 INFO - Reading from file tmpfile_stdout 23:10:54 INFO - Output received: 23:10:54 INFO - Usage: mozinstall [options] installer 23:10:54 INFO - Options: 23:10:54 INFO - -h, --help show this help message and exit 23:10:54 INFO - -d DEST, --destination=DEST 23:10:54 INFO - Directory to install application into. [default: 23:10:54 INFO - "/builds/slave/test"] 23:10:54 INFO - --app=APP Application being installed. [default: firefox] 23:10:54 INFO - mkdir: /builds/slave/test/build/application 23:10:54 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'] 23:10:54 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 23:11:10 INFO - Reading from file tmpfile_stdout 23:11:10 INFO - Output received: 23:11:10 INFO - /builds/slave/test/build/application/firefox/firefox 23:11:10 INFO - Running post-action listener: _resource_record_post_action 23:11:10 INFO - ##### 23:11:10 INFO - ##### Finished install step (success) 23:11:10 INFO - ##### 23:11:10 INFO - ##### 23:11:10 INFO - ##### Running run-tests step. 23:11:10 INFO - ##### 23:11:10 INFO - Running pre-action listener: _resource_record_pre_action 23:11:10 INFO - Running main action method: run_tests 23:11:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 23:11:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 23:11:10 INFO - Python 2.7.3 23:11:10 INFO - Return code: 0 23:11:10 INFO - grabbing minidump binary from tooltool 23:11: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')]} 23:11:10 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 0x2d49570>, '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 0x2d4a470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d4a900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 23:11:10 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 23:11:10 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 23:11:10 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 23:11:10 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:11:10 INFO - Return code: 0 23:11:10 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 23:11:10 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 23:11:10 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 23:11:10 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 23:11:10 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 23:11:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-052', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 23:11:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-052 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 23:11:10 INFO - Using env: {'DISPLAY': ':0', 23:11:10 INFO - 'HOME': '/home/cltbld', 23:11:10 INFO - 'LANG': 'en_US.UTF-8', 23:11:10 INFO - 'LANGUAGE': 'en_US:en', 23:11:10 INFO - 'LOGNAME': 'cltbld', 23:11:10 INFO - 'MAIL': '/var/mail/cltbld', 23:11:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 23:11:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 23:11:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:10 INFO - 'MOZ_NO_REMOTE': '1', 23:11:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 23:11:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:10 INFO - 'NO_EM_RESTART': '1', 23:11:10 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:10 INFO - 'PWD': '/builds/slave/test', 23:11:10 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 23:11:11 INFO - 'SHELL': '/bin/bash', 23:11:11 INFO - 'SHLVL': '1', 23:11:11 INFO - 'TERM': 'linux', 23:11:11 INFO - 'TMOUT': '86400', 23:11:11 INFO - 'USER': 'cltbld', 23:11:11 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628', 23:11:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:11 INFO - '_': '/tools/buildbot/bin/python'} 23:11:11 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-052', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 23:11:11 INFO - mozversion application_buildid: 20160629222829 23:11:11 INFO - mozversion application_changeset: dc96e5ff02fd23198a2b7f7a4c93a86a77c760c3 23:11:11 INFO - mozversion application_display_name: Nightly 23:11:11 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:11:11 INFO - mozversion application_name: Firefox 23:11:11 INFO - mozversion application_remotingname: firefox 23:11:11 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 23:11:11 INFO - mozversion application_vendor: Mozilla 23:11:11 INFO - mozversion application_version: 50.0a1 23:11:11 INFO - mozversion platform_buildid: 20160629222829 23:11:11 INFO - mozversion platform_changeset: dc96e5ff02fd23198a2b7f7a4c93a86a77c760c3 23:11:11 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 23:11:11 INFO - mozversion platform_version: 50.0a1 23:11:11 INFO - using testdate: 1467267071 23:11:11 INFO - actual date: 1467267071 23:11:11 INFO - starting webserver on 'localhost:57347' 23:11:11 INFO - SUITE-START | Running 2 tests 23:11:11 INFO - TEST-START | dromaeo_css 23:11:11 INFO - operating with platform_type : linux_ 23:11:11 INFO - Initialising browser for dromaeo_css test... 23:11:11 INFO - TEST-INFO | started process 22732 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFTStO6/profile http://localhost:57347/getInfo.html) 23:11:15 INFO - PROCESS | 22732 | __metrics Screen width/height:1600/1200 23:11:15 INFO - PROCESS | 22732 | colorDepth:24 23:11:15 INFO - PROCESS | 22732 | Browser inner width/height: 1024/697 23:11:15 INFO - PROCESS | 22732 | __metrics 23:11:16 ERROR - PROCESS | 22732 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 23:11:17 INFO - TEST-INFO | 22732: exit 0 23:11:17 INFO - Browser initialized. 23:11:17 INFO - Running cycle 1/1 for dromaeo_css test... 23:11:17 INFO - TEST-INFO | started process 22849 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFTStO6/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:11:29 INFO - PROCESS | 22849 | RSS: Main: 169525248 23:11:29 INFO - PROCESS | 22849 | 23:12:18 INFO - PROCESS | 22849 | 1467267138928 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] 23:14:31 INFO - PROCESS | 22849 | Cycle 1(1): loaded http://localhost:57347/tests/dromaeo/cssquery-dojo.html (next: http://localhost:57347/tests/dromaeo/cssquery-ext.html) 23:14:32 INFO - PROCESS | 22849 | RSS: Main: 170016768 23:14:32 INFO - PROCESS | 22849 | 23:17:34 INFO - PROCESS | 22849 | Cycle 1(1): loaded http://localhost:57347/tests/dromaeo/cssquery-ext.html (next: http://localhost:57347/tests/dromaeo/cssquery-jquery.html) 23:17:35 INFO - PROCESS | 22849 | RSS: Main: 168910848 23:17:35 INFO - PROCESS | 22849 | 23:20:37 INFO - PROCESS | 22849 | Cycle 1(1): loaded http://localhost:57347/tests/dromaeo/cssquery-jquery.html (next: http://localhost:57347/tests/dromaeo/cssquery-mootools.html) 23:20:38 INFO - PROCESS | 22849 | RSS: Main: 172015616 23:20:38 INFO - PROCESS | 22849 | 23:23:39 INFO - PROCESS | 22849 | Cycle 1(1): loaded http://localhost:57347/tests/dromaeo/cssquery-mootools.html (next: http://localhost:57347/tests/dromaeo/cssquery-prototype.html) 23:23:40 INFO - PROCESS | 22849 | RSS: Main: 167854080 23:23:40 INFO - PROCESS | 22849 | 23:26:43 INFO - PROCESS | 22849 | Cycle 1(1): loaded http://localhost:57347/tests/dromaeo/cssquery-prototype.html (next: http://localhost:57347/tests/dromaeo/cssquery-yui.html) 23:26:43 INFO - PROCESS | 22849 | RSS: Main: 169443328 23:26:43 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | Cycle 1(1): loaded http://localhost:57347/tests/dromaeo/cssquery-yui.html (next: http://localhost:57347/tests/dromaeo/cssquery-dojo.html) 23:29:46 INFO - PROCESS | 22849 | RSS: Main: 170725376 23:29:46 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | __start_tp_report 23:29:46 INFO - PROCESS | 22849 | _x_x_mozilla_page_load 23:29:46 INFO - PROCESS | 22849 | _x_x_mozilla_page_load_details 23:29:46 INFO - PROCESS | 22849 | |i|pagename|runs| 23:29:46 INFO - PROCESS | 22849 | |0;dojo.html;2662.494126116038;2692.151972128779;2698.1500827239406;2714.3892624159566;2726.2775364528393;4732.739699316537;4735.147673418784;4747.145513807513;4788.377510923575;4871.318015477827;4744.762761861902;4745.003549254652;4753.1681955657705;4863.927041094386;4880.121578115938;4309.978450107753;4371.956280437203;4406.581374769407;4449.5995360417555;4454.665900057493;643.1417104626057;4120.990357362451;4291.141771645668;4375.496817865955;4447.533009034038;4446.733196008234;4473.194824931511;4478;4483.932741008887;4506.571875671806;4477.261251893434;4485.439320084989;4497.550244975476;4509.346144808985;4543.568361005699;4350.129974005212;4405.22908491016;4415.51429342772;4417.4919884213405;4441.467023957113;4787;4803.855884323441;4814.590759785422;4834.58905992991;4838.129136755382;5012.874678133076;5095;5187.351581052369;5188.429272780029;5222.764975576109;5134.768935397916;5142.871428214287;5159.251908473288;5201.895962080737;5252.816151434681;4839.7096174229655;4847.079054979543;4847.3698419205275;4848.345473361122;4879.634027447955;5205.27126202332;5270.631055826056;5292.100342941709;5303.124984377611;5308.0445519806035;5074.517920797518;5082.872928176751;5089.109405853961;5120.974395128001;5150.845474635767;5151.742412879416;5164.1995490699;5165.225216217522;5193.740312984336;5201.635885487979;5012.724300163453;5079.415867175248;5110.744462776846;5118.232265160182;5127.3847138343635;4969.527894849984;5039.899202015939;5082.771275292621;5091.414487334004;5117.74411279442;4323.956760432418;4330.848420305274;4344.4352234209355;4347.3261644445165;4400.185965596375;3727.254549090193;3762.078290818767;3762.360398732222;3805.276997370491;3828.1003964068423;4478.193925093515;4485.304777759453;4501.7974191161475;4502.189605870909;4571.565701258375;5208.192730126836;5211.661242019257;5213.348331458567;5219.295395121686;5223.712695801767;4443.2224360736745;4504.774761261924;4559.658025648023;4564.566366195206;4569.497355290915;4628.791704373311;4685.765711714401;4691.577758001728;4703.976480117646;4705.1765940960195;4924.212126059813;4935.802567897315;4950.653454258311;4968.776405061709;4983.975080124721;5030.673006254582;5186.06650802844;5235.947640523546;5243.659162154448;5258.6581872178185;4910.386201724785;4917.336159618549;4920;4954.20732682769;4974.825881094144;5042.117629414911;5139.640225184201;5145.176771716657;5149.716765577929;5152.27868098474;5137.768800404066;5144.485551444825;5147.58819294448;5168.405633352213;5170.922436163385;5028.874278143076;5036.6726162799305;5040.747962601782;5058.696478211319;5080.49195080489;4959.13215187348;5024.171011783015;5033.949660503495;5049.621278404061;5062.772175252049;4998.350214472095;5020.949790502048;5035.420926593489;5059.038782631288;5112.769925353442;5091.490850914879;5104.770285337243;5132.717700526507;5133.409657889241;5147.9227811582105;4844.781984810622;4987.251912213197;5013.147764879906;5063.316452278895;5063.645544811828 23:29:46 INFO - PROCESS | 22849 | |1;ext.html;541.9680789987369;572.2817863581205;583.9036558967771;593.5815250248576;650.9479241660667;35080;39927.20145597086;40047.79976100119;40119.39820902689;40155;39497.80251098741;39552.40671389924;39754.60245397545;40084.59915400845;40151.59848401515;7856.725014624503;8017.6392062357045;8026.357891368706;8031.879521807177;8056.194380561956;7940.523568585874;7958.681652733883;7989.360851131895;8021.117677055519;8037.839243215132;8043.798905027392;8057.838843223132;8078.636461359223;8081.7171399001045;8088.716894908679;8028.759137225892;8030;8041;8044.155363686846;8052.3558115350925;7980.082290536605;7996.9200307997335;8029.5985200740315;8044.477108987956;8065.112837587919;30543;38044.61955380438;38388.61611383906;38581.228375432336;38659.42010869811;2882.2218001139786;2926.385459053601;2938.5004549226683;3386.86452541898;3557.7865328080397;27704;28201.717982820115;28289.575656364967;28541.857290713415;28815.85592072047;3394.8302584870657;3408.744344174172;3442.8794992175403;3444.9827750861336;3459.187091033605;220338;221230;221453;222232;223258;32961.175970600925;33128.17179570482;33217.667823321455;33255.334893301995;33256.501152482735;29951;30382;30438.69561304403;30485.39029219403;30518.69481305203;15572;15602.29789659468;15638.06171629706;15663.451779187673;15789.921050394903;12084.368610237681;12085.939570302093;12148.757024859453;12177.756444871053;12219;18606.81393186078;18652.34716784906;18737.531561711065;18754.655668041494;18775.624487510173;6901.516893817485;6906.136732908387;6942.271061538567;7061.258567850302;7133.251008644018;785.2422412372089;892.683097500391;901.8557030875029;954.4082668745423;1008.742770593494;28277.15168544947;28514;28922.81848996609;28939.56590651142;29277.56083658747;934.5187228577288;949.6296444386695;1009.7071849163807;1018.1447584029451;1070.1813112968584;15101.3204405802;15477.613059673598;15504.844951550565;15646.2176891155;15652.608684782972;397432;399476;402661;403330;403749;51116;51186.232206516936;51538.48461515337;51735.22397164046;51763.223551646755;1169.8069818479855;1179.0685358566807;1213.7026428525244;1215.0279776179023;1220.5422966387605;26178.607320890584;27223.59164612493;27353;27733.30666733348;27765.722342776313;43261.56738432701;43430.131397371246;43867.341989870816;43985.34021989737;44015;325574;327161;328478;328715;329974;25590.87204563965;25901.611475828253;26060.739392605832;26337.473250535266;26386.86806565955;43263.351049734905;43322.78338608287;43655.78172109246;43817.780911095244;44548.55451445444;37618.24763504769;37658;37786.811065944494;38390;38493.230135396574;37406.6259337414;37537.06157345979;37593.43609845909;38089.42865856959;38112.42831357476;32121.678783212803;36777.448338275484;36904.630953691194;37636.62363376331;37809.243815122994;33621;34791.304173916884;35008.245415350546;35179.47230791489;35223.82388088043;26189.607155893056;26304.605430918167;26497;26535.734642653326;26545.867270663523 23:29:46 INFO - PROCESS | 22849 | |2;jquery.html;356.3478833734265;362.1453370046689;364.8431174594924;368.0908156852573;375.778290808423;16597.917010414945;17876.463706088824;18028.369007084737;18513.259469621233;18646.34737784178;17142.82857171428;17288.91355543224;18314.084295785226;18365.44903652889;18427.17077731502;4731.4795372509;4842.927356089662;4872;4886.144924638192;4887.340209071783;3501.264734405765;4815.301781241717;5990.9101363479585;6268.153799237113;6269.749210031593;6287.4655654269445;6287.968560157193;6301;6318.71565779541;6345.079963405304;6103.145559621678;6180.84547886302;6241.438270555672;6339.11252424661;6366.745330186787;5329.774151945075;5494.862628434321;5496.148097044965;5516.889662206733;5524.558035357162;12634.74730505394;12673.04952128594;12709.428075736521;12710.809337859939;17432.477025689248;2030.3299911029326;2148.419926619804;2156.762756096828;2385.7375688674233;2405.3625789165885;8889.599968001456;9364.110409511153;9378.85931711025;9534.427934323963;9610.75973100671;1713.6315692126127;1726.085174857315;1744.8429641332214;1770.876038677293;1795.0806643884616;69106;72335;75999.62000189963;76440.61779691122;77806;10358.948205259076;10376.688699339033;10457.163426925828;10555.63055293061;10612.151027917747;14329.068610540282;14413;14460.27698615086;14468;14493.710125797636;7345.669444874993;7723.806904827425;7831.960840195762;7864.5281283123195;7917.960410197912;7148.964255178691;7195.316444937723;7288.453365997571;7335.559866408033;7338.4496162788;4253.97873010633;4300.397944287803;4339.134172305939;4428.844990425319;4527.84152554659;1715.125286104096;1779.813119622447;1844.9631007379778;1873.8594605404649;1879.6898511745683;782.2568559868148;814.486873269848;877.368294827723;905.6060613633091;926.6247169896203;16188.838111618734;16556.254968526446;16948.152592370334;17156;17431.65136697259;823.8681810910225;855.1234984141305;861.2722249698994;863.5121156546531;885.4333226734894;6593.406593406617;9903.554340054714;9904.356216845881;9932.851007234898;9981.600735970625;386290;397039;423560;425755;426645;76755;78086;78934.605326973;79294.603526982;79441.60279198682;877.899041610223;883.0418995389946;885.0618344554664;888.4092078767676;906.9138431848963;15386.769198461809;15543.533693989199;15681.294341754421;15817.181024181906;15964.699964640256;37170.8141459291;37292.813535932146;37527.43708844315;37815.810920945216;38836.41745373765;53099;54502.72748636232;55300.44699552953;58753.70623146857;59859.700701496215;4400.603945644907;4506.369108324771;7097.538659987084;7880.369570434237;8178.7955301117945;9337;12523.561675341683;12570.811437828257;12577.119601627799;12817.935910320388;9146.496942668216;9416.576254068446;9614.95192524033;9708.902910971083;9945.900540994497;10311.948440257751;10353.844692329772;10756.569737210424;10896.673099807018;11105.777884442105;10096.596136154472;10109.34289271195;10214.948925255327;10283.537240824331;10363.844542332023;7915.05019397676;7925.603719814101;7996.720114795954;8010.638191507574;8200.097989221062;8987.41581797181;9962.850557241502;10054.597816087567;10274.948625256826;10288.897111029093 23:29:46 INFO - PROCESS | 22849 | |3;mootools.html;1320.9735805283894;1384.3977869626713;1439.7696368581023;1706.7439884017404;1731.385358197839;7107.218205997337;7549.50928189668;7639.923600764005;8070.515769053854;8076.0308762948525;7773.572453515055;8068.112507624157;8118.472299300556;8125.228103330189;8223.13657066007;2229.4649284171765;2246.135237933391;2250.3923940536047;2257.4243567890167;2259.9322020339414;2220.8667479951173;2238.350878245307;2262.4343914021497;2276.362618466832;2283.862968221904;2236.0720301075116;2259.0737797503025;2261.9660705089436;2266.7733226677365;2288.4050146961827;2167.393129923616;2168.219441001246;2173.119886445992;2175.662772270293;2177.5318306564163;2124.022949443258;2145.324222869791;2145.731783527059;2147.108949785837;2151.075037733774;7960.044794624624;8056.436049476539;8066.798330041737;8101.9189808101755;8103.837923241502;4652.278896771006;4749.1926372516755;4780.402449693788;4784.760761961888;4789.616830653575;2832;2987.2233219362906;3025.5310426883866;3031.4543382191196;3042.7413669838093;911.6444586611227;935.7286386947777;957.0812020460297;965.5317171172046;990.1830989433746;10911.181661375429;10941.83587246192;11005.119590432827;11018.779624407547;11039.448027598668;4042.2319759245647;4103.281925662997;4253.787310634456;4272.551382104896;4277.636400905895;9445.197158241626;9472.100150485692;9481.340765366034;9481.857772133424;9490.952545237367;4710.905781884411;4733.171694953369;4750.786214620351;4752.1683705351425;4755.120302744003;3672.3389789838084;4107.466029416157;4289.828406863753;4294.957050429456;4351.564843515623;3672.2839046385698;3678.613745556678;3753.4557489163917;3791.1469919267943;3796.468494410785;1170.7365842685329;1196.5512932650256;1198.8561372635165;1209.7157168065498;1219.408586835384;703.7783098324012;791.4538968111984;829.6971605363999;844.6494704697604;852.2925971443686;5143.7685304161405;5240.266362709223;5274.367075950834;5279.627296902756;5294.894102117936;397.4951811199818;405.54173783624316;410.6776180698138;412.44526112378804;417.84957415330456;3693.9445908311395;3747.9063023424087;3764.9435258471144;3804.7336686431686;3861;9564.473953932462;9760.170385517169;9807.26445516589;9889;9895.65365212214;9666.359483535993;9785.315027947976;9794.510274486389;9817;9827.75430614226;7410.110786705522;7532.510386824839;7610.39116870649;7616.466847320635;7630.2751238632245;5009.724465154306;5223.869403264949;5315.176147697113;5347.545458635904;5466.289382380265;8976.55117244122;9143.405678630868;9224.631014759334;9229;9231.76920576991;9018.954905225432;9208.723738287863;9234.907650923406;9264.53677316145;9276.72169834906;6337.081123237197;6659.733610655519;6762.49281303914;6796.694148763417;6845.555038922654;7564.546127232384;7601.581912994839;7617.69529218825;7630.389568834591;7684.538927664358;6845.110135682329;7017.614031228331;7083.574985500886;7130.786076417716;7174.605396703023;6735.259121496533;6784.7964561063245;6878.518503704893;6968.65156742171;6984;5912.793052243151;5914.112883067574;5936.465718085393;6042.969785151046;6079.574429790049;4470.575295346936;4472.709273897186;4490.461144662661;4525.773711314355;4542.068875880371;4474.597286244254;4532.048269863366;4670.8365207217585;4723.338732577373;4854.83008094715 23:29:46 INFO - PROCESS | 22849 | |4;prototype.html;292.21103021841026;297.79154591785755;299.21456177533975;300.936803271313;302.06962555329585;5109.5182397104845;5196.558292545138;5197.428282888879;5203.583713302941;5212.244224587433;5090.261912022755;5122.257272695457;5122.897542049166;5123.12906805843;5123.641345105844;3750.624937506248;3853.9421908671393;3951.70362222833;3957.3272543667504;3997.2804895118866;3941.645251927326;3957.663598594123;3968.7618742875375;3980.4228386883883;3987.900302492432;3946.8223929923224;3951.5455722591837;3956.7428117172435;3958.0896393829435;3959.7624142551394;3702.352088384549;3923.293807114718;3924.9607503925167;3954.268460334833;3970.325044742386;3384.4431561481747;3387.1024178592693;3388.6950174484414;3418.3163367326633;3419.8290085495873;4983.750812459399;4994.325766021577;5006.4492905780335;5015.194529969208;5019.924701129486;4243.130158317537;4493.236149854532;4503.48209955856;4506.233940230136;4516.322551617251;5310.336207974004;5317;5320.255164277004;5348.545373643245;5365.356157261114;3732.2908647356917;3736.831842567091;3743.1577894973684;3744.8314825832904;3751.512303400568;5344.412114667344;5589.385167631557;5641.323041235037;5647.604667673265;5648.548116150698;3805.562360328542;3808.485854409619;3809.3143234218105;3818.770873747584;3821.4396354442592;3850.6726928211415;3860.6332398422105;3872.3997780344093;3872.593377695358;3888.202918401721;4419.292913133948;4437.556244375602;4450.376947227391;4461.24158892989;4468.642508599304;5178.093833579184;5256.894862102737;5261.868698229899;5267.815626453055;5291.126964050888;1303.791393377055;1317.8352705911761;1320.5576131995888;1322.4644019172251;1323.7683405404016;830.8421399934114;835.1731785532279;840.4831028917172;849.6304107713164;880.1022956584249;4653.115907977473;4680.7191568506;4685.219616545691;4689.273162659793;4693.108309421199;5447.673139611636;5460.645058071213;5466.972665136649;5490.478404551562;5498.917516237259;4545.636349092065;4684.6486513510945;4706.435227772689;4714.316424118484;4744.620430365562;2892.5805758164947;2904.157794239689;2904.288449329885;2913.548399998004;2918.270432391902;5088.262201980692;5103.464136265638;5131.846044618667;5131.846044618667;5161.896762064737;5408.864778380572;5513.807016754475;5542.806001789918;5674.2339784129435;5685.744141513559;5217.895642087061;5224.320838290998;5233.566391627911;5241.73791310433;5294.523492885736;5585.854899745624;5590;5596.496315331639;5619.634723742944;5632.239647647679;5178.197379406198;5403.675779453245;5421.5391691706645;5423.132298832168;5462.8361149165585;5258.6581872178185;5270.78916843322;5278.46924391922;5284.81503147388;5301.310829592128;3856.6753210580646;3860.189360234382;3896.1428485733095;3896.532416110085;3907.824147913294;5464.251439539309;5491.90161967616;5518.448155184449;5521.282233309644;5533.5849811263515;5352.330958630171;5403.648762830403;5406.810501689622;5414.458554144554;5458.0721277382145;5100.464451232716;5336.252924590638;5375.3012108425655;5376.327959005124;5394.595405344537;5280.260763493191;5301.284326615858;5329.387120481194;5346;5364.275822763877;5162.457941916045;5260.9736951315;5379.327584051994;5434.538064264581;5439.401665816677;5302.8144014960835;5338.1992701093595;5346.358436987586;5367.651102678314;5371 23:29:46 INFO - PROCESS | 22849 | |5;yui.html;602.8794241151769;627.2128478759157;627.7959663109491;677.9661016949151;686.368540942333;11387.772244555104;12168.513259469633;12208.877911220885;12226.877731222685;12246.387680615968;11116;11432.485538150782;11448.71378215545;11735.119866010062;12007.939960300208;635.5328833307515;752.2665401233794;769.1193583347065;774.1059076766315;774.639792496489;775.1744392222265;780.6916268074108;781.5935713429013;783.5964478293655;788.9881651775199;818.4311903227259;821.6466919224731;825.6037102190952;826.243986752121;828.6395417993192;821.2772759971187;823.0534884882373;823.9752807415787;824.2046425199682;824.6783754335814;607.6020206764576;607.7113371148713;607.902735562308;608.2548877624919;608.4341562347015;11905.702357441047;11949.283043017447;11991.100667449977;12004.279743215435;12018.218815776947;12904.87095129046;13246.66883327915;13341;13379.130356526795;13512.59462216135;10012.098911098035;10040;10061.14480269178;10100.141487973531;10236.795264094751;3321.136504508821;3337.0656216259486;3351.581052368454;3376.6285708572036;3402.6767457091537;64599.03101453482;66294.00558991668;66593.3340666592;68574;68855;10066.647667331608;10143;10645.839651203883;10705.678829635124;10865.45672716361;17772.644547109245;17869.642607147784;17992.91003544974;18019.459416217273;18032.819671803376;6860.416864566568;6968.756093536702;7060.71757129709;7094.787156385213;7106.598984771582;3475.3223121491064;3736.7384283100464;3759.172981943968;3784.148566572499;3785.7539259948567;2738.3427977285705;2865.3409715765492;2987.7012298770383;2989.446952313829;2992;484.0874950717922;489.59119135521524;489.87997940504806;495.2571143285072;497.5546885537496;445.2497541642343;494.6537423803352;506.6200349737697;533.5171669638983;565.5560385097679;7692.807679807937;7884.921150788534;7979.162187970295;8059.83880322402;8091.514509129471;530.2894121876703;539.9919001214985;552.6987791653559;552.9861753456196;572.0018567599566;3514.279572687593;3664.340418724602;3694.538182727159;3703.4815125882396;3758.248350329945;77632.22367776363;80655.59672201601;96291;106164;107269.4636526828;79362;81187.59406203049;82934.58532707297;83724.16275837286;83725.58137209275;46499.76750116228;54654.72672636611;72743.63628181825;73502.63248683722;76161.6191919048;7807.843843122992;8069.7175598853755;8215.958920205361;8249.340052795882;8272.710455134042;43134;43255;43678.78160609177;45141.774291128335;46165;57925.420745792006;58944.705276473345;66980.33019669741;67135.66432167808;67691;9700.805983880424;9731.270154738282;9917.65288214909;9919.65281215154;10123.987601240111;12475.875241247835;12670.30784508441;12769.233845969271;12849.100562960502;12858.807117893051;11570.421478925851;11571.594994175164;11628.476718547516;11691;11728.530858765555;11198.21612487118;11678.182527223013;12172.14794964344;12201.938990304992;12232;11397.202195846212;11511.258516313146;11644.88355116438;11936.164468487123;11964.880351196376;8992.550372481219;9121.361504694607;9155.359124861196;9309.255259579082;9386.249100072115;9471.526423678926;9663.591510377997;9751.56117974707;9825.361351512129;9875.950620246853 23:29:46 INFO - PROCESS | 22849 | __end_tp_report 23:29:46 INFO - PROCESS | 22849 | __start_cc_report 23:29:46 INFO - PROCESS | 22849 | _x_x_mozilla_cycle_collect,383 23:29:46 INFO - PROCESS | 22849 | __end_cc_report 23:29:46 INFO - PROCESS | 22849 | __startTimestamp1467268186944__endTimestamp 23:29:46 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | ------- Summary: start ------- 23:29:46 INFO - PROCESS | 22849 | Number of tests: 6 23:29:46 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | [#0] dojo.html Cycles:165 Average:4756.98 Median:4959.13 stddev:599.47 (12.1%) stddev-sans-first:578.35 23:29:46 INFO - PROCESS | 22849 | Values: 2662.5 2692.2 2698.2 2714.4 2726.3 4732.7 4735.1 4747.1 4788.4 4871.3 4744.8 4745.0 4753.2 4863.9 4880.1 4310.0 4372.0 4406.6 4449.6 4454.7 643.1 4121.0 4291.1 4375.5 4447.5 4446.7 4473.2 4478.0 4483.9 4506.6 4477.3 4485.4 4497.6 4509.3 4543.6 4350.1 4405.2 4415.5 4417.5 4441.5 4787.0 4803.9 4814.6 4834.6 4838.1 5012.9 5095.0 5187.4 5188.4 5222.8 5134.8 5142.9 5159.3 5201.9 5252.8 4839.7 4847.1 4847.4 4848.3 4879.6 5205.3 5270.6 5292.1 5303.1 5308.0 5074.5 5082.9 5089.1 5121.0 5150.8 5151.7 5164.2 5165.2 5193.7 5201.6 5012.7 5079.4 5110.7 5118.2 5127.4 4969.5 5039.9 5082.8 5091.4 5117.7 4324.0 4330.8 4344.4 4347.3 4400.2 3727.3 3762.1 3762.4 3805.3 3828.1 4478.2 4485.3 4501.8 4502.2 4571.6 5208.2 5211.7 5213.3 5219.3 5223.7 4443.2 4504.8 4559.7 4564.6 4569.5 4628.8 4685.8 4691.6 4704.0 4705.2 4924.2 4935.8 4950.7 4968.8 4984.0 5030.7 5186.1 5235.9 5243.7 5258.7 4910.4 4917.3 4920.0 4954.2 4974.8 5042.1 5139.6 5145.2 5149.7 5152.3 5137.8 5144.5 5147.6 5168.4 5170.9 5028.9 5036.7 5040.7 5058.7 5080.5 4959.1 5024.2 5033.9 5049.6 5062.8 4998.4 5020.9 5035.4 5059.0 5112.8 5091.5 5104.8 5132.7 5133.4 5147.9 4844.8 4987.3 5013.1 5063.3 5063.6 23:29:46 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | [#1] ext.html Cycles:180 Average:46446.34 Median:19390.81 stddev:85814.43 (442.6%) stddev-sans-first:85985.95 23:29:46 INFO - PROCESS | 22849 | Values: 542.0 572.3 583.9 593.6 650.9 35080.0 39927.2 40047.8 40119.4 40155.0 39497.8 39552.4 39754.6 40084.6 40151.6 7856.7 8017.6 8026.4 8031.9 8056.2 7940.5 7958.7 7989.4 8021.1 8037.8 8043.8 8057.8 8078.6 8081.7 8088.7 8028.8 8030.0 8041.0 8044.2 8052.4 7980.1 7996.9 8029.6 8044.5 8065.1 30543.0 38044.6 38388.6 38581.2 38659.4 2882.2 2926.4 2938.5 3386.9 3557.8 27704.0 28201.7 28289.6 28541.9 28815.9 3394.8 3408.7 3442.9 3445.0 3459.2 220338.0 221230.0 221453.0 222232.0 223258.0 32961.2 33128.2 33217.7 33255.3 33256.5 29951.0 30382.0 30438.7 30485.4 30518.7 15572.0 15602.3 15638.1 15663.5 15789.9 12084.4 12085.9 12148.8 12177.8 12219.0 18606.8 18652.3 18737.5 18754.7 18775.6 6901.5 6906.1 6942.3 7061.3 7133.3 785.2 892.7 901.9 954.4 1008.7 28277.2 28514.0 28922.8 28939.6 29277.6 934.5 949.6 1009.7 1018.1 1070.2 15101.3 15477.6 15504.8 15646.2 15652.6 397432.0 399476.0 402661.0 403330.0 403749.0 51116.0 51186.2 51538.5 51735.2 51763.2 1169.8 1179.1 1213.7 1215.0 1220.5 26178.6 27223.6 27353.0 27733.3 27765.7 43261.6 43430.1 43867.3 43985.3 44015.0 325574.0 327161.0 328478.0 328715.0 329974.0 25590.9 25901.6 26060.7 26337.5 26386.9 43263.4 43322.8 43655.8 43817.8 44548.6 37618.2 37658.0 37786.8 38390.0 38493.2 37406.6 37537.1 37593.4 38089.4 38112.4 32121.7 36777.4 36904.6 37636.6 37809.2 33621.0 34791.3 35008.2 35179.5 35223.8 26189.6 26304.6 26497.0 26535.7 26545.9 23:29:46 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | [#2] jquery.html Cycles:180 Average:25205.60 Median:4773.39 stddev:68128.43 (1427.3%) stddev-sans-first:68294.00 23:29:46 INFO - PROCESS | 22849 | Values: 356.3 362.1 364.8 368.1 375.8 16597.9 17876.5 18028.4 18513.3 18646.3 17142.8 17288.9 18314.1 18365.4 18427.2 4731.5 4842.9 4872.0 4886.1 4887.3 3501.3 4815.3 5990.9 6268.2 6269.7 6287.5 6288.0 6301.0 6318.7 6345.1 6103.1 6180.8 6241.4 6339.1 6366.7 5329.8 5494.9 5496.1 5516.9 5524.6 12634.7 12673.0 12709.4 12710.8 17432.5 2030.3 2148.4 2156.8 2385.7 2405.4 8889.6 9364.1 9378.9 9534.4 9610.8 1713.6 1726.1 1744.8 1770.9 1795.1 69106.0 72335.0 75999.6 76440.6 77806.0 10358.9 10376.7 10457.2 10555.6 10612.2 14329.1 14413.0 14460.3 14468.0 14493.7 7345.7 7723.8 7832.0 7864.5 7918.0 7149.0 7195.3 7288.5 7335.6 7338.4 4254.0 4300.4 4339.1 4428.8 4527.8 1715.1 1779.8 1845.0 1873.9 1879.7 782.3 814.5 877.4 905.6 926.6 16188.8 16556.3 16948.2 17156.0 17431.7 823.9 855.1 861.3 863.5 885.4 6593.4 9903.6 9904.4 9932.9 9981.6 386290.0 397039.0 423560.0 425755.0 426645.0 76755.0 78086.0 78934.6 79294.6 79441.6 877.9 883.0 885.1 888.4 906.9 15386.8 15543.5 15681.3 15817.2 15964.7 37170.8 37292.8 37527.4 37815.8 38836.4 53099.0 54502.7 55300.4 58753.7 59859.7 4400.6 4506.4 7097.5 7880.4 8178.8 9337.0 12523.6 12570.8 12577.1 12817.9 9146.5 9416.6 9615.0 9708.9 9945.9 10311.9 10353.8 10756.6 10896.7 11105.8 10096.6 10109.3 10214.9 10283.5 10363.8 7915.1 7925.6 7996.7 8010.6 8200.1 8987.4 9962.9 10054.6 10274.9 10288.9 23:29:46 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | [#3] mootools.html Cycles:180 Average:5219.51 Median:5076.75 stddev:2969.22 (58.5%) stddev-sans-first:2963.10 23:29:46 INFO - PROCESS | 22849 | Values: 1321.0 1384.4 1439.8 1706.7 1731.4 7107.2 7549.5 7639.9 8070.5 8076.0 7773.6 8068.1 8118.5 8125.2 8223.1 2229.5 2246.1 2250.4 2257.4 2259.9 2220.9 2238.4 2262.4 2276.4 2283.9 2236.1 2259.1 2262.0 2266.8 2288.4 2167.4 2168.2 2173.1 2175.7 2177.5 2124.0 2145.3 2145.7 2147.1 2151.1 7960.0 8056.4 8066.8 8101.9 8103.8 4652.3 4749.2 4780.4 4784.8 4789.6 2832.0 2987.2 3025.5 3031.5 3042.7 911.6 935.7 957.1 965.5 990.2 10911.2 10941.8 11005.1 11018.8 11039.4 4042.2 4103.3 4253.8 4272.6 4277.6 9445.2 9472.1 9481.3 9481.9 9491.0 4710.9 4733.2 4750.8 4752.2 4755.1 3672.3 4107.5 4289.8 4295.0 4351.6 3672.3 3678.6 3753.5 3791.1 3796.5 1170.7 1196.6 1198.9 1209.7 1219.4 703.8 791.5 829.7 844.6 852.3 5143.8 5240.3 5274.4 5279.6 5294.9 397.5 405.5 410.7 412.4 417.8 3693.9 3747.9 3764.9 3804.7 3861.0 9564.5 9760.2 9807.3 9889.0 9895.7 9666.4 9785.3 9794.5 9817.0 9827.8 7410.1 7532.5 7610.4 7616.5 7630.3 5009.7 5223.9 5315.2 5347.5 5466.3 8976.6 9143.4 9224.6 9229.0 9231.8 9019.0 9208.7 9234.9 9264.5 9276.7 6337.1 6659.7 6762.5 6796.7 6845.6 7564.5 7601.6 7617.7 7630.4 7684.5 6845.1 7017.6 7083.6 7130.8 7174.6 6735.3 6784.8 6878.5 6968.7 6984.0 5912.8 5914.1 5936.5 6043.0 6079.6 4470.6 4472.7 4490.5 4525.8 4542.1 4474.6 4532.0 4670.8 4723.3 4854.8 23:29:46 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | [#4] prototype.html Cycles:180 Average:4428.24 Median:5122.58 stddev:1312.96 (25.6%) stddev-sans-first:1279.42 23:29:46 INFO - PROCESS | 22849 | Values: 292.2 297.8 299.2 300.9 302.1 5109.5 5196.6 5197.4 5203.6 5212.2 5090.3 5122.3 5122.9 5123.1 5123.6 3750.6 3853.9 3951.7 3957.3 3997.3 3941.6 3957.7 3968.8 3980.4 3987.9 3946.8 3951.5 3956.7 3958.1 3959.8 3702.4 3923.3 3925.0 3954.3 3970.3 3384.4 3387.1 3388.7 3418.3 3419.8 4983.8 4994.3 5006.4 5015.2 5019.9 4243.1 4493.2 4503.5 4506.2 4516.3 5310.3 5317.0 5320.3 5348.5 5365.4 3732.3 3736.8 3743.2 3744.8 3751.5 5344.4 5589.4 5641.3 5647.6 5648.5 3805.6 3808.5 3809.3 3818.8 3821.4 3850.7 3860.6 3872.4 3872.6 3888.2 4419.3 4437.6 4450.4 4461.2 4468.6 5178.1 5256.9 5261.9 5267.8 5291.1 1303.8 1317.8 1320.6 1322.5 1323.8 830.8 835.2 840.5 849.6 880.1 4653.1 4680.7 4685.2 4689.3 4693.1 5447.7 5460.6 5467.0 5490.5 5498.9 4545.6 4684.6 4706.4 4714.3 4744.6 2892.6 2904.2 2904.3 2913.5 2918.3 5088.3 5103.5 5131.8 5131.8 5161.9 5408.9 5513.8 5542.8 5674.2 5685.7 5217.9 5224.3 5233.6 5241.7 5294.5 5585.9 5590.0 5596.5 5619.6 5632.2 5178.2 5403.7 5421.5 5423.1 5462.8 5258.7 5270.8 5278.5 5284.8 5301.3 3856.7 3860.2 3896.1 3896.5 3907.8 5464.3 5491.9 5518.4 5521.3 5533.6 5352.3 5403.6 5406.8 5414.5 5458.1 5100.5 5336.3 5375.3 5376.3 5394.6 5280.3 5301.3 5329.4 5346.0 5364.3 5162.5 5261.0 5379.3 5434.5 5439.4 5302.8 5338.2 5346.4 5367.7 5371.0 23:29:46 INFO - PROCESS | 22849 | 23:29:46 INFO - PROCESS | 22849 | [#5] yui.html Cycles:180 Average:17286.04 Median:502.09 stddev:24784.82 (4936.4%) stddev-sans-first:24822.69 23:29:46 INFO - PROCESS | 22849 | Values: 602.9 627.2 627.8 678.0 686.4 11387.8 12168.5 12208.9 12226.9 12246.4 11116.0 11432.5 11448.7 11735.1 12007.9 635.5 752.3 769.1 774.1 774.6 775.2 780.7 781.6 783.6 789.0 818.4 821.6 825.6 826.2 828.6 821.3 823.1 824.0 824.2 824.7 607.6 607.7 607.9 608.3 608.4 11905.7 11949.3 11991.1 12004.3 12018.2 12904.9 13246.7 13341.0 13379.1 13512.6 10012.1 10040.0 10061.1 10100.1 10236.8 3321.1 3337.1 3351.6 3376.6 3402.7 64599.0 66294.0 66593.3 68574.0 68855.0 10066.6 10143.0 10645.8 10705.7 10865.5 17772.6 17869.6 17992.9 18019.5 18032.8 6860.4 6968.8 7060.7 7094.8 7106.6 3475.3 3736.7 3759.2 3784.1 3785.8 2738.3 2865.3 2987.7 2989.4 2992.0 484.1 489.6 489.9 495.3 497.6 445.2 494.7 506.6 533.5 565.6 7692.8 7884.9 7979.2 8059.8 8091.5 530.3 540.0 552.7 553.0 572.0 3514.3 3664.3 3694.5 3703.5 3758.2 77632.2 80655.6 96291.0 106164.0 107269.5 79362.0 81187.6 82934.6 83724.2 83725.6 46499.8 54654.7 72743.6 73502.6 76161.6 7807.8 8069.7 8216.0 8249.3 8272.7 43134.0 43255.0 43678.8 45141.8 46165.0 57925.4 58944.7 66980.3 67135.7 67691.0 9700.8 9731.3 9917.7 9919.7 10124.0 12475.9 12670.3 12769.2 12849.1 12858.8 11570.4 11571.6 11628.5 11691.0 11728.5 11198.2 11678.2 12172.1 12201.9 12232.0 11397.2 11511.3 11644.9 11936.2 11964.9 8992.6 9121.4 9155.4 9309.3 9386.2 9471.5 9663.6 9751.6 9825.4 9876.0 23:29:46 INFO - PROCESS | 22849 | -------- Summary: end -------- 23:29:46 INFO - PROCESS | 22849 | 23:29:47 INFO - TEST-INFO | 22849: exit 0 23:29:47 INFO - TEST-OK | dromaeo_css | took 1116519ms 23:29:47 INFO - TEST-START | kraken 23:29:47 INFO - operating with platform_type : linux_ 23:29:47 INFO - Initialising browser for kraken test... 23:29:47 INFO - TEST-INFO | started process 23096 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpxjIrzO/profile http://localhost:57347/getInfo.html) 23:29:52 INFO - PROCESS | 23096 | __metrics Screen width/height:1600/1200 23:29:52 INFO - PROCESS | 23096 | colorDepth:24 23:29:52 INFO - PROCESS | 23096 | Browser inner width/height: 1024/697 23:29:52 INFO - PROCESS | 23096 | __metrics 23:29:53 ERROR - PROCESS | 23096 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 23:29:53 INFO - TEST-INFO | 23096: exit 0 23:29:53 INFO - Browser initialized. 23:29:53 INFO - Running cycle 1/1 for kraken test... 23:29:53 INFO - TEST-INFO | started process 23213 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpxjIrzO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:30:05 INFO - PROCESS | 23213 | RSS: Main: 169512960 23:30:05 INFO - PROCESS | 23213 | 23:30:08 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:57347/tests/kraken/driver.html?testName=audio-beat-detection) 23:30:09 INFO - PROCESS | 23213 | RSS: Main: 174624768 23:30:09 INFO - PROCESS | 23213 | 23:30:12 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:57347/tests/kraken/driver.html?testName=audio-dft) 23:30:12 INFO - PROCESS | 23213 | RSS: Main: 174784512 23:30:12 INFO - PROCESS | 23213 | 23:30:15 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:57347/tests/kraken/driver.html?testName=audio-fft) 23:30:16 INFO - PROCESS | 23213 | RSS: Main: 169259008 23:30:16 INFO - PROCESS | 23213 | 23:30:18 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:57347/tests/kraken/driver.html?testName=audio-oscillator) 23:30:19 INFO - PROCESS | 23213 | RSS: Main: 169590784 23:30:19 INFO - PROCESS | 23213 | 23:30:21 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:57347/tests/kraken/driver.html?testName=imaging-gaussian-blur) 23:30:22 INFO - PROCESS | 23213 | RSS: Main: 170131456 23:30:22 INFO - PROCESS | 23213 | 23:30:25 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:57347/tests/kraken/driver.html?testName=imaging-darkroom) 23:30:25 INFO - PROCESS | 23213 | RSS: Main: 170295296 23:30:25 INFO - PROCESS | 23213 | 23:30:29 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:57347/tests/kraken/driver.html?testName=imaging-desaturate) 23:30:30 INFO - PROCESS | 23213 | RSS: Main: 167817216 23:30:30 INFO - PROCESS | 23213 | 23:30:33 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:57347/tests/kraken/driver.html?testName=json-parse-financial) 23:30:33 INFO - PROCESS | 23213 | RSS: Main: 168878080 23:30:33 INFO - PROCESS | 23213 | 23:30:35 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:57347/tests/kraken/driver.html?testName=json-stringify-tinderbox) 23:30:35 INFO - PROCESS | 23213 | RSS: Main: 169353216 23:30:35 INFO - PROCESS | 23213 | 23:30:37 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:57347/tests/kraken/driver.html?testName=stanford-crypto-aes) 23:30:38 INFO - PROCESS | 23213 | RSS: Main: 169390080 23:30:38 INFO - PROCESS | 23213 | 23:30:40 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:57347/tests/kraken/driver.html?testName=stanford-crypto-ccm) 23:30:41 INFO - PROCESS | 23213 | RSS: Main: 170106880 23:30:41 INFO - PROCESS | 23213 | 23:30:44 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:57347/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 23:30:44 INFO - PROCESS | 23213 | RSS: Main: 170807296 23:30:44 INFO - PROCESS | 23213 | 23:30:47 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:57347/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 23:30:48 INFO - PROCESS | 23213 | RSS: Main: 170143744 23:30:48 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | Cycle 1(1): loaded http://localhost:57347/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:57347/tests/kraken/driver.html?testName=ai-astar) 23:30:50 INFO - PROCESS | 23213 | RSS: Main: 170684416 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | __start_tp_report 23:30:50 INFO - PROCESS | 23213 | _x_x_mozilla_page_load 23:30:50 INFO - PROCESS | 23213 | _x_x_mozilla_page_load_details 23:30:50 INFO - PROCESS | 23213 | |i|pagename|runs| 23:30:50 INFO - PROCESS | 23213 | |0;ai-astar;106;115;107;114;113;114;115;117;116;116 23:30:50 INFO - PROCESS | 23213 | |1;audio-beat-detection;166;127;149;176;126;145;154;127;190;125 23:30:50 INFO - PROCESS | 23213 | |2;audio-dft;164;162;167;166;173;166;167;166;163;161 23:30:50 INFO - PROCESS | 23213 | |3;audio-fft;75;75;77;156;77;77;80;75;171;78 23:30:50 INFO - PROCESS | 23213 | |4;audio-oscillator;86;85;145;85;86;85;138;86;85;140 23:30:50 INFO - PROCESS | 23213 | |5;imaging-gaussian-blur;118;121;118;118;118;118;118;118;118;118 23:30:50 INFO - PROCESS | 23213 | |6;imaging-darkroom;148;148;149;148;147;147;148;147;148;148 23:30:50 INFO - PROCESS | 23213 | |7;imaging-desaturate;95;96;95;96;95;95;95;95;96;95 23:30:50 INFO - PROCESS | 23213 | |8;json-parse-financial;64;63;65;64;63;64;63;62;63;64 23:30:50 INFO - PROCESS | 23213 | |9;json-stringify-tinderbox;65;65;65;64;65;66;66;66;64;66 23:30:50 INFO - PROCESS | 23213 | |10;stanford-crypto-aes;80;80;80;79;81;80;78;80;88;79 23:30:50 INFO - PROCESS | 23213 | |11;stanford-crypto-ccm;143;134;129;133;137;133;134;133;172;133 23:30:50 INFO - PROCESS | 23213 | |12;stanford-crypto-pbkdf2;169;166;166;169;171;166;169;165;171;167 23:30:50 INFO - PROCESS | 23213 | |13;stanford-crypto-sha256-iterative;68;72;79;68;70;67;71;67;68;67 23:30:50 INFO - PROCESS | 23213 | __end_tp_report 23:30:50 INFO - PROCESS | 23213 | __start_cc_report 23:30:50 INFO - PROCESS | 23213 | _x_x_mozilla_cycle_collect,974 23:30:50 INFO - PROCESS | 23213 | __end_cc_report 23:30:50 INFO - PROCESS | 23213 | __startTimestamp1467268250290__endTimestamp 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | ------- Summary: start ------- 23:30:50 INFO - PROCESS | 23213 | Number of tests: 14 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#0] ai-astar Cycles:10 Average:113.30 Median:115.00 stddev:3.77 (3.3%) stddev-sans-first:2.93 23:30:50 INFO - PROCESS | 23213 | Values: 106.0 115.0 107.0 114.0 113.0 114.0 115.0 117.0 116.0 116.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#1] audio-beat-detection Cycles:10 Average:148.50 Median:151.50 stddev:23.12 (15.3%) stddev-sans-first:23.64 23:30:50 INFO - PROCESS | 23213 | Values: 166.0 127.0 149.0 176.0 126.0 145.0 154.0 127.0 190.0 125.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#2] audio-dft Cycles:10 Average:165.50 Median:166.00 stddev:3.37 (2.0%) stddev-sans-first:3.54 23:30:50 INFO - PROCESS | 23213 | Values: 164.0 162.0 167.0 166.0 173.0 166.0 167.0 166.0 163.0 161.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#3] audio-fft Cycles:10 Average:94.10 Median:77.00 stddev:36.78 (47.8%) stddev-sans-first:38.36 23:30:50 INFO - PROCESS | 23213 | Values: 75.0 75.0 77.0 156.0 77.0 77.0 80.0 75.0 171.0 78.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#4] audio-oscillator Cycles:10 Average:102.10 Median:85.00 stddev:26.90 (31.6%) stddev-sans-first:27.89 23:30:50 INFO - PROCESS | 23213 | Values: 86.0 85.0 145.0 85.0 86.0 85.0 138.0 86.0 85.0 140.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#5] imaging-gaussian-blur Cycles:10 Average:118.30 Median:118.00 stddev:0.95 (0.8%) stddev-sans-first:1.00 23:30:50 INFO - PROCESS | 23213 | Values: 118.0 121.0 118.0 118.0 118.0 118.0 118.0 118.0 118.0 118.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#6] imaging-darkroom Cycles:10 Average:147.80 Median:148.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 23:30:50 INFO - PROCESS | 23213 | Values: 148.0 148.0 149.0 148.0 147.0 147.0 148.0 147.0 148.0 148.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#7] imaging-desaturate Cycles:10 Average:95.30 Median:95.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 23:30:50 INFO - PROCESS | 23213 | Values: 95.0 96.0 95.0 96.0 95.0 95.0 95.0 95.0 96.0 95.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#8] json-parse-financial Cycles:10 Average:63.50 Median:64.00 stddev:0.85 (1.3%) stddev-sans-first:0.88 23:30:50 INFO - PROCESS | 23213 | Values: 64.0 63.0 65.0 64.0 63.0 64.0 63.0 62.0 63.0 64.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#9] json-stringify-tinderbox Cycles:10 Average:65.20 Median:65.50 stddev:0.79 (1.2%) stddev-sans-first:0.83 23:30:50 INFO - PROCESS | 23213 | Values: 65.0 65.0 65.0 64.0 65.0 66.0 66.0 66.0 64.0 66.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#10] stanford-crypto-aes Cycles:10 Average:80.50 Median:80.00 stddev:2.76 (3.4%) stddev-sans-first:2.92 23:30:50 INFO - PROCESS | 23213 | Values: 80.0 80.0 80.0 79.0 81.0 80.0 78.0 80.0 88.0 79.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#11] stanford-crypto-ccm Cycles:10 Average:138.10 Median:134.00 stddev:12.45 (9.3%) stddev-sans-first:13.08 23:30:50 INFO - PROCESS | 23213 | Values: 143.0 134.0 129.0 133.0 137.0 133.0 134.0 133.0 172.0 133.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.90 Median:169.00 stddev:2.18 (1.3%) stddev-sans-first:2.28 23:30:50 INFO - PROCESS | 23213 | Values: 169.0 166.0 166.0 169.0 171.0 166.0 169.0 165.0 171.0 167.0 23:30:50 INFO - PROCESS | 23213 | 23:30:50 INFO - PROCESS | 23213 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.70 Median:69.00 stddev:3.71 (5.4%) stddev-sans-first:3.89 23:30:50 INFO - PROCESS | 23213 | Values: 68.0 72.0 79.0 68.0 70.0 67.0 71.0 67.0 68.0 67.0 23:30:50 INFO - PROCESS | 23213 | -------- Summary: end -------- 23:30:50 INFO - PROCESS | 23213 | 23:30:51 INFO - TEST-INFO | 23213: exit 0 23:30:51 INFO - TEST-OK | kraken | took 63623ms 23:30:51 INFO - SUITE-END | took 1180s 23:30:51 INFO - Completed test suite (00:19:40) 23:30:51 INFO - javascript benchmark 23:30:51 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6439.3382961839, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2662.494126116038, 2692.151972128779, 2698.1500827239406, 2714.3892624159566, 2726.2775364528393, 4732.739699316537, 4735.147673418784, 4747.145513807513, 4788.377510923575, 4871.318015477827, 4744.762761861902, 4745.003549254652, 4753.1681955657705, 4863.927041094386, 4880.121578115938, 4309.978450107753, 4371.956280437203, 4406.581374769407, 4449.5995360417555, 4454.665900057493, 643.1417104626057, 4120.990357362451, 4291.141771645668, 4375.496817865955, 4447.533009034038, 4446.733196008234, 4473.194824931511, 4478.0, 4483.932741008887, 4506.571875671806, 4477.261251893434, 4485.439320084989, 4497.550244975476, 4509.346144808985, 4543.568361005699, 4350.129974005212, 4405.22908491016, 4415.51429342772, 4417.4919884213405, 4441.467023957113, 4787.0, 4803.855884323441, 4814.590759785422, 4834.58905992991, 4838.129136755382, 5012.874678133076, 5095.0, 5187.351581052369, 5188.429272780029, 5222.764975576109, 5134.768935397916, 5142.871428214287, 5159.251908473288, 5201.895962080737, 5252.816151434681, 4839.7096174229655, 4847.079054979543, 4847.3698419205275, 4848.345473361122, 4879.634027447955, 5205.27126202332, 5270.631055826056, 5292.100342941709, 5303.124984377611, 5308.0445519806035, 5074.517920797518, 5082.872928176751, 5089.109405853961, 5120.974395128001, 5150.845474635767, 5151.742412879416, 5164.1995490699, 5165.225216217522, 5193.740312984336, 5201.635885487979, 5012.724300163453, 5079.415867175248, 5110.744462776846, 5118.232265160182, 5127.3847138343635, 4969.527894849984, 5039.899202015939, 5082.771275292621, 5091.414487334004, 5117.74411279442, 4323.956760432418, 4330.848420305274, 4344.4352234209355, 4347.3261644445165, 4400.185965596375, 3727.254549090193, 3762.078290818767, 3762.360398732222, 3805.276997370491, 3828.1003964068423, 4478.193925093515, 4485.304777759453, 4501.7974191161475, 4502.189605870909, 4571.565701258375, 5208.192730126836, 5211.661242019257, 5213.348331458567, 5219.295395121686, 5223.712695801767, 4443.2224360736745, 4504.774761261924, 4559.658025648023, 4564.566366195206, 4569.497355290915, 4628.791704373311, 4685.765711714401, 4691.577758001728, 4703.976480117646, 4705.1765940960195, 4924.212126059813, 4935.802567897315, 4950.653454258311, 4968.776405061709, 4983.975080124721, 5030.673006254582, 5186.06650802844, 5235.947640523546, 5243.659162154448, 5258.6581872178185, 4910.386201724785, 4917.336159618549, 4920.0, 4954.20732682769, 4974.825881094144, 5042.117629414911, 5139.640225184201, 5145.176771716657, 5149.716765577929, 5152.27868098474, 5137.768800404066, 5144.485551444825, 5147.58819294448, 5168.405633352213, 5170.922436163385, 5028.874278143076, 5036.6726162799305, 5040.747962601782, 5058.696478211319, 5080.49195080489, 4959.13215187348, 5024.171011783015, 5033.949660503495, 5049.621278404061, 5062.772175252049, 4998.350214472095, 5020.949790502048, 5035.420926593489, 5059.038782631288, 5112.769925353442, 5091.490850914879, 5104.770285337243, 5132.717700526507, 5133.409657889241, 5147.9227811582105, 4844.781984810622, 4987.251912213197, 5013.147764879906, 5063.316452278895, 5063.645544811828], "value": 4719.663776609766, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [541.9680789987369, 572.2817863581205, 583.9036558967771, 593.5815250248576, 650.9479241660667, 35080.0, 39927.20145597086, 40047.79976100119, 40119.39820902689, 40155.0, 39497.80251098741, 39552.40671389924, 39754.60245397545, 40084.59915400845, 40151.59848401515, 7856.725014624503, 8017.6392062357045, 8026.357891368706, 8031.879521807177, 8056.194380561956, 7940.523568585874, 7958.681652733883, 7989.360851131895, 8021.117677055519, 8037.839243215132, 8043.798905027392, 8057.838843223132, 8078.636461359223, 8081.7171399001045, 8088.716894908679, 8028.759137225892, 8030.0, 8041.0, 8044.155363686846, 8052.3558115350925, 7980.082290536605, 7996.9200307997335, 8029.5985200740315, 8044.477108987956, 8065.112837587919, 30543.0, 38044.61955380438, 38388.61611383906, 38581.228375432336, 38659.42010869811, 2882.2218001139786, 2926.385459053601, 2938.5004549226683, 3386.86452541898, 3557.7865328080397, 27704.0, 28201.717982820115, 28289.575656364967, 28541.857290713415, 28815.85592072047, 3394.8302584870657, 3408.744344174172, 3442.8794992175403, 3444.9827750861336, 3459.187091033605, 220338.0, 221230.0, 221453.0, 222232.0, 223258.0, 32961.175970600925, 33128.17179570482, 33217.667823321455, 33255.334893301995, 33256.501152482735, 29951.0, 30382.0, 30438.69561304403, 30485.39029219403, 30518.69481305203, 15572.0, 15602.29789659468, 15638.06171629706, 15663.451779187673, 15789.921050394903, 12084.368610237681, 12085.939570302093, 12148.757024859453, 12177.756444871053, 12219.0, 18606.81393186078, 18652.34716784906, 18737.531561711065, 18754.655668041494, 18775.624487510173, 6901.516893817485, 6906.136732908387, 6942.271061538567, 7061.258567850302, 7133.251008644018, 785.2422412372089, 892.683097500391, 901.8557030875029, 954.4082668745423, 1008.742770593494, 28277.15168544947, 28514.0, 28922.81848996609, 28939.56590651142, 29277.56083658747, 934.5187228577288, 949.6296444386695, 1009.7071849163807, 1018.1447584029451, 1070.1813112968584, 15101.3204405802, 15477.613059673598, 15504.844951550565, 15646.2176891155, 15652.608684782972, 397432.0, 399476.0, 402661.0, 403330.0, 403749.0, 51116.0, 51186.232206516936, 51538.48461515337, 51735.22397164046, 51763.223551646755, 1169.8069818479855, 1179.0685358566807, 1213.7026428525244, 1215.0279776179023, 1220.5422966387605, 26178.607320890584, 27223.59164612493, 27353.0, 27733.30666733348, 27765.722342776313, 43261.56738432701, 43430.131397371246, 43867.341989870816, 43985.34021989737, 44015.0, 325574.0, 327161.0, 328478.0, 328715.0, 329974.0, 25590.87204563965, 25901.611475828253, 26060.739392605832, 26337.473250535266, 26386.86806565955, 43263.351049734905, 43322.78338608287, 43655.78172109246, 43817.780911095244, 44548.55451445444, 37618.24763504769, 37658.0, 37786.811065944494, 38390.0, 38493.230135396574, 37406.6259337414, 37537.06157345979, 37593.43609845909, 38089.42865856959, 38112.42831357476, 32121.678783212803, 36777.448338275484, 36904.630953691194, 37636.62363376331, 37809.243815122994, 33621.0, 34791.304173916884, 35008.245415350546, 35179.47230791489, 35223.82388088043, 26189.607155893056, 26304.605430918167, 26497.0, 26535.734642653326, 26545.867270663523], "value": 17341.191139402727, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [356.3478833734265, 362.1453370046689, 364.8431174594924, 368.0908156852573, 375.778290808423, 16597.917010414945, 17876.463706088824, 18028.369007084737, 18513.259469621233, 18646.34737784178, 17142.82857171428, 17288.91355543224, 18314.084295785226, 18365.44903652889, 18427.17077731502, 4731.4795372509, 4842.927356089662, 4872.0, 4886.144924638192, 4887.340209071783, 3501.264734405765, 4815.301781241717, 5990.9101363479585, 6268.153799237113, 6269.749210031593, 6287.4655654269445, 6287.968560157193, 6301.0, 6318.71565779541, 6345.079963405304, 6103.145559621678, 6180.84547886302, 6241.438270555672, 6339.11252424661, 6366.745330186787, 5329.774151945075, 5494.862628434321, 5496.148097044965, 5516.889662206733, 5524.558035357162, 12634.74730505394, 12673.04952128594, 12709.428075736521, 12710.809337859939, 17432.477025689248, 2030.3299911029326, 2148.419926619804, 2156.762756096828, 2385.7375688674233, 2405.3625789165885, 8889.599968001456, 9364.110409511153, 9378.85931711025, 9534.427934323963, 9610.75973100671, 1713.6315692126127, 1726.085174857315, 1744.8429641332214, 1770.876038677293, 1795.0806643884616, 69106.0, 72335.0, 75999.62000189963, 76440.61779691122, 77806.0, 10358.948205259076, 10376.688699339033, 10457.163426925828, 10555.63055293061, 10612.151027917747, 14329.068610540282, 14413.0, 14460.27698615086, 14468.0, 14493.710125797636, 7345.669444874993, 7723.806904827425, 7831.960840195762, 7864.5281283123195, 7917.960410197912, 7148.964255178691, 7195.316444937723, 7288.453365997571, 7335.559866408033, 7338.4496162788, 4253.97873010633, 4300.397944287803, 4339.134172305939, 4428.844990425319, 4527.84152554659, 1715.125286104096, 1779.813119622447, 1844.9631007379778, 1873.8594605404649, 1879.6898511745683, 782.2568559868148, 814.486873269848, 877.368294827723, 905.6060613633091, 926.6247169896203, 16188.838111618734, 16556.254968526446, 16948.152592370334, 17156.0, 17431.65136697259, 823.8681810910225, 855.1234984141305, 861.2722249698994, 863.5121156546531, 885.4333226734894, 6593.406593406617, 9903.554340054714, 9904.356216845881, 9932.851007234898, 9981.600735970625, 386290.0, 397039.0, 423560.0, 425755.0, 426645.0, 76755.0, 78086.0, 78934.605326973, 79294.603526982, 79441.60279198682, 877.899041610223, 883.0418995389946, 885.0618344554664, 888.4092078767676, 906.9138431848963, 15386.769198461809, 15543.533693989199, 15681.294341754421, 15817.181024181906, 15964.699964640256, 37170.8141459291, 37292.813535932146, 37527.43708844315, 37815.810920945216, 38836.41745373765, 53099.0, 54502.72748636232, 55300.44699552953, 58753.70623146857, 59859.700701496215, 4400.603945644907, 4506.369108324771, 7097.538659987084, 7880.369570434237, 8178.7955301117945, 9337.0, 12523.561675341683, 12570.811437828257, 12577.119601627799, 12817.935910320388, 9146.496942668216, 9416.576254068446, 9614.95192524033, 9708.902910971083, 9945.900540994497, 10311.948440257751, 10353.844692329772, 10756.569737210424, 10896.673099807018, 11105.777884442105, 10096.596136154472, 10109.34289271195, 10214.948925255327, 10283.537240824331, 10363.844542332023, 7915.05019397676, 7925.603719814101, 7996.720114795954, 8010.638191507574, 8200.097989221062, 8987.41581797181, 9962.850557241502, 10054.597816087567, 10274.948625256826, 10288.897111029093], "value": 8287.803876028249, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1320.9735805283894, 1384.3977869626713, 1439.7696368581023, 1706.7439884017404, 1731.385358197839, 7107.218205997337, 7549.50928189668, 7639.923600764005, 8070.515769053854, 8076.0308762948525, 7773.572453515055, 8068.112507624157, 8118.472299300556, 8125.228103330189, 8223.13657066007, 2229.4649284171765, 2246.135237933391, 2250.3923940536047, 2257.4243567890167, 2259.9322020339414, 2220.8667479951173, 2238.350878245307, 2262.4343914021497, 2276.362618466832, 2283.862968221904, 2236.0720301075116, 2259.0737797503025, 2261.9660705089436, 2266.7733226677365, 2288.4050146961827, 2167.393129923616, 2168.219441001246, 2173.119886445992, 2175.662772270293, 2177.5318306564163, 2124.022949443258, 2145.324222869791, 2145.731783527059, 2147.108949785837, 2151.075037733774, 7960.044794624624, 8056.436049476539, 8066.798330041737, 8101.9189808101755, 8103.837923241502, 4652.278896771006, 4749.1926372516755, 4780.402449693788, 4784.760761961888, 4789.616830653575, 2832.0, 2987.2233219362906, 3025.5310426883866, 3031.4543382191196, 3042.7413669838093, 911.6444586611227, 935.7286386947777, 957.0812020460297, 965.5317171172046, 990.1830989433746, 10911.181661375429, 10941.83587246192, 11005.119590432827, 11018.779624407547, 11039.448027598668, 4042.2319759245647, 4103.281925662997, 4253.787310634456, 4272.551382104896, 4277.636400905895, 9445.197158241626, 9472.100150485692, 9481.340765366034, 9481.857772133424, 9490.952545237367, 4710.905781884411, 4733.171694953369, 4750.786214620351, 4752.1683705351425, 4755.120302744003, 3672.3389789838084, 4107.466029416157, 4289.828406863753, 4294.957050429456, 4351.564843515623, 3672.2839046385698, 3678.613745556678, 3753.4557489163917, 3791.1469919267943, 3796.468494410785, 1170.7365842685329, 1196.5512932650256, 1198.8561372635165, 1209.7157168065498, 1219.408586835384, 703.7783098324012, 791.4538968111984, 829.6971605363999, 844.6494704697604, 852.2925971443686, 5143.7685304161405, 5240.266362709223, 5274.367075950834, 5279.627296902756, 5294.894102117936, 397.4951811199818, 405.54173783624316, 410.6776180698138, 412.44526112378804, 417.84957415330456, 3693.9445908311395, 3747.9063023424087, 3764.9435258471144, 3804.7336686431686, 3861.0, 9564.473953932462, 9760.170385517169, 9807.26445516589, 9889.0, 9895.65365212214, 9666.359483535993, 9785.315027947976, 9794.510274486389, 9817.0, 9827.75430614226, 7410.110786705522, 7532.510386824839, 7610.39116870649, 7616.466847320635, 7630.2751238632245, 5009.724465154306, 5223.869403264949, 5315.176147697113, 5347.545458635904, 5466.289382380265, 8976.55117244122, 9143.405678630868, 9224.631014759334, 9229.0, 9231.76920576991, 9018.954905225432, 9208.723738287863, 9234.907650923406, 9264.53677316145, 9276.72169834906, 6337.081123237197, 6659.733610655519, 6762.49281303914, 6796.694148763417, 6845.555038922654, 7564.546127232384, 7601.581912994839, 7617.69529218825, 7630.389568834591, 7684.538927664358, 6845.110135682329, 7017.614031228331, 7083.574985500886, 7130.786076417716, 7174.605396703023, 6735.259121496533, 6784.7964561063245, 6878.518503704893, 6968.65156742171, 6984.0, 5912.793052243151, 5914.112883067574, 5936.465718085393, 6042.969785151046, 6079.574429790049, 4470.575295346936, 4472.709273897186, 4490.461144662661, 4525.773711314355, 4542.068875880371, 4474.597286244254, 4532.048269863366, 4670.8365207217585, 4723.338732577373, 4854.83008094715], "value": 4119.2300136537815, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [292.21103021841026, 297.79154591785755, 299.21456177533975, 300.936803271313, 302.06962555329585, 5109.5182397104845, 5196.558292545138, 5197.428282888879, 5203.583713302941, 5212.244224587433, 5090.261912022755, 5122.257272695457, 5122.897542049166, 5123.12906805843, 5123.641345105844, 3750.624937506248, 3853.9421908671393, 3951.70362222833, 3957.3272543667504, 3997.2804895118866, 3941.645251927326, 3957.663598594123, 3968.7618742875375, 3980.4228386883883, 3987.900302492432, 3946.8223929923224, 3951.5455722591837, 3956.7428117172435, 3958.0896393829435, 3959.7624142551394, 3702.352088384549, 3923.293807114718, 3924.9607503925167, 3954.268460334833, 3970.325044742386, 3384.4431561481747, 3387.1024178592693, 3388.6950174484414, 3418.3163367326633, 3419.8290085495873, 4983.750812459399, 4994.325766021577, 5006.4492905780335, 5015.194529969208, 5019.924701129486, 4243.130158317537, 4493.236149854532, 4503.48209955856, 4506.233940230136, 4516.322551617251, 5310.336207974004, 5317.0, 5320.255164277004, 5348.545373643245, 5365.356157261114, 3732.2908647356917, 3736.831842567091, 3743.1577894973684, 3744.8314825832904, 3751.512303400568, 5344.412114667344, 5589.385167631557, 5641.323041235037, 5647.604667673265, 5648.548116150698, 3805.562360328542, 3808.485854409619, 3809.3143234218105, 3818.770873747584, 3821.4396354442592, 3850.6726928211415, 3860.6332398422105, 3872.3997780344093, 3872.593377695358, 3888.202918401721, 4419.292913133948, 4437.556244375602, 4450.376947227391, 4461.24158892989, 4468.642508599304, 5178.093833579184, 5256.894862102737, 5261.868698229899, 5267.815626453055, 5291.126964050888, 1303.791393377055, 1317.8352705911761, 1320.5576131995888, 1322.4644019172251, 1323.7683405404016, 830.8421399934114, 835.1731785532279, 840.4831028917172, 849.6304107713164, 880.1022956584249, 4653.115907977473, 4680.7191568506, 4685.219616545691, 4689.273162659793, 4693.108309421199, 5447.673139611636, 5460.645058071213, 5466.972665136649, 5490.478404551562, 5498.917516237259, 4545.636349092065, 4684.6486513510945, 4706.435227772689, 4714.316424118484, 4744.620430365562, 2892.5805758164947, 2904.157794239689, 2904.288449329885, 2913.548399998004, 2918.270432391902, 5088.262201980692, 5103.464136265638, 5131.846044618667, 5131.846044618667, 5161.896762064737, 5408.864778380572, 5513.807016754475, 5542.806001789918, 5674.2339784129435, 5685.744141513559, 5217.895642087061, 5224.320838290998, 5233.566391627911, 5241.73791310433, 5294.523492885736, 5585.854899745624, 5590.0, 5596.496315331639, 5619.634723742944, 5632.239647647679, 5178.197379406198, 5403.675779453245, 5421.5391691706645, 5423.132298832168, 5462.8361149165585, 5258.6581872178185, 5270.78916843322, 5278.46924391922, 5284.81503147388, 5301.310829592128, 3856.6753210580646, 3860.189360234382, 3896.1428485733095, 3896.532416110085, 3907.824147913294, 5464.251439539309, 5491.90161967616, 5518.448155184449, 5521.282233309644, 5533.5849811263515, 5352.330958630171, 5403.648762830403, 5406.810501689622, 5414.458554144554, 5458.0721277382145, 5100.464451232716, 5336.252924590638, 5375.3012108425655, 5376.327959005124, 5394.595405344537, 5280.260763493191, 5301.284326615858, 5329.387120481194, 5346.0, 5364.275822763877, 5162.457941916045, 5260.9736951315, 5379.327584051994, 5434.538064264581, 5439.401665816677, 5302.8144014960835, 5338.1992701093595, 5346.358436987586, 5367.651102678314, 5371.0], "value": 4000.537469574038, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [602.8794241151769, 627.2128478759157, 627.7959663109491, 677.9661016949151, 686.368540942333, 11387.772244555104, 12168.513259469633, 12208.877911220885, 12226.877731222685, 12246.387680615968, 11116.0, 11432.485538150782, 11448.71378215545, 11735.119866010062, 12007.939960300208, 635.5328833307515, 752.2665401233794, 769.1193583347065, 774.1059076766315, 774.639792496489, 775.1744392222265, 780.6916268074108, 781.5935713429013, 783.5964478293655, 788.9881651775199, 818.4311903227259, 821.6466919224731, 825.6037102190952, 826.243986752121, 828.6395417993192, 821.2772759971187, 823.0534884882373, 823.9752807415787, 824.2046425199682, 824.6783754335814, 607.6020206764576, 607.7113371148713, 607.902735562308, 608.2548877624919, 608.4341562347015, 11905.702357441047, 11949.283043017447, 11991.100667449977, 12004.279743215435, 12018.218815776947, 12904.87095129046, 13246.66883327915, 13341.0, 13379.130356526795, 13512.59462216135, 10012.098911098035, 10040.0, 10061.14480269178, 10100.141487973531, 10236.795264094751, 3321.136504508821, 3337.0656216259486, 3351.581052368454, 3376.6285708572036, 3402.6767457091537, 64599.03101453482, 66294.00558991668, 66593.3340666592, 68574.0, 68855.0, 10066.647667331608, 10143.0, 10645.839651203883, 10705.678829635124, 10865.45672716361, 17772.644547109245, 17869.642607147784, 17992.91003544974, 18019.459416217273, 18032.819671803376, 6860.416864566568, 6968.756093536702, 7060.71757129709, 7094.787156385213, 7106.598984771582, 3475.3223121491064, 3736.7384283100464, 3759.172981943968, 3784.148566572499, 3785.7539259948567, 2738.3427977285705, 2865.3409715765492, 2987.7012298770383, 2989.446952313829, 2992.0, 484.0874950717922, 489.59119135521524, 489.87997940504806, 495.2571143285072, 497.5546885537496, 445.2497541642343, 494.6537423803352, 506.6200349737697, 533.5171669638983, 565.5560385097679, 7692.807679807937, 7884.921150788534, 7979.162187970295, 8059.83880322402, 8091.514509129471, 530.2894121876703, 539.9919001214985, 552.6987791653559, 552.9861753456196, 572.0018567599566, 3514.279572687593, 3664.340418724602, 3694.538182727159, 3703.4815125882396, 3758.248350329945, 77632.22367776363, 80655.59672201601, 96291.0, 106164.0, 107269.4636526828, 79362.0, 81187.59406203049, 82934.58532707297, 83724.16275837286, 83725.58137209275, 46499.76750116228, 54654.72672636611, 72743.63628181825, 73502.63248683722, 76161.6191919048, 7807.843843122992, 8069.7175598853755, 8215.958920205361, 8249.340052795882, 8272.710455134042, 43134.0, 43255.0, 43678.78160609177, 45141.774291128335, 46165.0, 57925.420745792006, 58944.705276473345, 66980.33019669741, 67135.66432167808, 67691.0, 9700.805983880424, 9731.270154738282, 9917.65288214909, 9919.65281215154, 10123.987601240111, 12475.875241247835, 12670.30784508441, 12769.233845969271, 12849.100562960502, 12858.807117893051, 11570.421478925851, 11571.594994175164, 11628.476718547516, 11691.0, 11728.530858765555, 11198.21612487118, 11678.182527223013, 12172.14794964344, 12201.938990304992, 12232.0, 11397.202195846212, 11511.258516313146, 11644.88355116438, 11936.164468487123, 11964.880351196376, 8992.550372481219, 9121.361504694607, 9155.359124861196, 9309.255259579082, 9386.249100072115, 9471.526423678926, 9663.591510377997, 9751.56117974707, 9825.361351512129, 9875.950620246853], "value": 6377.298376240946, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1569.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 115.0, 107.0, 114.0, 113.0, 114.0, 115.0, 117.0, 116.0, 116.0], "value": 113.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 127.0, 149.0, 176.0, 126.0, 145.0, 154.0, 127.0, 190.0, 125.0], "value": 148.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 162.0, 167.0, 166.0, 173.0, 166.0, 167.0, 166.0, 163.0, 161.0], "value": 165.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 77.0, 156.0, 77.0, 77.0, 80.0, 75.0, 171.0, 78.0], "value": 94.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 85.0, 145.0, 85.0, 86.0, 85.0, 138.0, 86.0, 85.0, 140.0], "value": 102.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 121.0, 118.0, 118.0, 118.0, 118.0, 118.0, 118.0, 118.0, 118.0], "value": 118.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 148.0, 149.0, 148.0, 147.0, 147.0, 148.0, 147.0, 148.0, 148.0], "value": 147.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0], "value": 95.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 63.0, 65.0, 64.0, 63.0, 64.0, 63.0, 62.0, 63.0, 64.0], "value": 63.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 65.0, 64.0, 65.0, 66.0, 66.0, 66.0, 64.0, 66.0], "value": 65.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 80.0, 80.0, 79.0, 81.0, 80.0, 78.0, 80.0, 88.0, 79.0], "value": 80.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [143.0, 134.0, 129.0, 133.0, 137.0, 133.0, 134.0, 133.0, 172.0, 133.0], "value": 138.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 166.0, 166.0, 169.0, 171.0, 166.0, 169.0, 165.0, 171.0, 167.0], "value": 167.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 72.0, 79.0, 68.0, 70.0, 67.0, 71.0, 67.0, 68.0, 67.0], "value": 69.7, "unit": "score"}]}]} 23:30:51 INFO - Return code: 0 23:30:51 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 23:30:51 ERROR - # TBPL SUCCESS # 23:30:51 INFO - Running post-action listener: _resource_record_post_action 23:30:51 INFO - ##### 23:30:51 INFO - ##### Finished run-tests step (success) 23:30:51 INFO - ##### 23:30:51 INFO - Running post-run listener: _resource_record_post_run 23:30:51 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 4096; Write bytes: 545751040; Read time: 16; Write time: 520144 23:30:51 INFO - TinderboxPrint: CPU usage
13.3% 23:30:51 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 23:30:51 INFO - TinderboxPrint: I/O write bytes / time
545,751,040 / 520,144 23:30:51 INFO - TinderboxPrint: CPU idle
8,281.6 (86.7%) 23:30:51 INFO - TinderboxPrint: CPU user
1,218.6 (12.8%) 23:30:51 INFO - TinderboxPrint: Swap in / out
0 / 0 23:30:51 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 253186048; Read time: 0; Write time: 258508 23:30:51 INFO - run-tests - Wall time: 1181s; CPU: 13.0%; Read bytes: 0; Write bytes: 288595968; Read time: 0; Write time: 261172 23:30:52 INFO - Running post-run listener: _upload_blobber_files 23:30:52 INFO - Blob upload gear active. 23:30:52 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 23:30:52 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 23:30:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 23:30:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 23:30:52 INFO - (blobuploader) - INFO - Open directory for files ... 23:30:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 23:30:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:30:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:30:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 23:30:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:30:53 INFO - (blobuploader) - INFO - Done attempting. 23:30:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 23:30:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:30:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:30:57 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 23:30:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:30:57 INFO - (blobuploader) - INFO - Done attempting. 23:30:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 23:30:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:30:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:30:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 23:30:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:30:58 INFO - (blobuploader) - INFO - Done attempting. 23:30:58 INFO - (blobuploader) - INFO - Iteration through files over. 23:30:58 INFO - Return code: 0 23:30:58 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 23:30:58 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 23:30:58 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7ef9290eda976f4e3e3bc041e9303380f2435ee1ab66a663cccfdd523d38098f1d32b9cc037f524804aa83fc1d6cd24d06da82ad449c0eb2a68724ff1fb0c770", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/d550f5bbdba6d44241b8715e253be30f872ca1489fdd9b3ed81755e0209c8465f66d584979a7780c5cdbedc50c03b793c79416c7365855cf684b9758962b9a4e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/0067bac38444ef0524261d499950944f9b419967f3007b80ebda8688ca17ff51519fc46a34ec38cc7841ef169eaf9944b397cd6faf3d8eea3fb8ec01b2629cc2"} 23:30:58 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 23:30:58 INFO - Writing to file /builds/slave/test/properties/blobber_files 23:30:58 INFO - Contents: 23:30:58 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7ef9290eda976f4e3e3bc041e9303380f2435ee1ab66a663cccfdd523d38098f1d32b9cc037f524804aa83fc1d6cd24d06da82ad449c0eb2a68724ff1fb0c770", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/d550f5bbdba6d44241b8715e253be30f872ca1489fdd9b3ed81755e0209c8465f66d584979a7780c5cdbedc50c03b793c79416c7365855cf684b9758962b9a4e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/0067bac38444ef0524261d499950944f9b419967f3007b80ebda8688ca17ff51519fc46a34ec38cc7841ef169eaf9944b397cd6faf3d8eea3fb8ec01b2629cc2"} 23:30:58 INFO - Running post-run listener: copy_logs_to_upload_dir 23:30:58 INFO - Copying logs to upload dir... 23:30:58 INFO - mkdir: /builds/slave/test/build/upload/logs 23:30:58 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1234.646438 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-06-29 23:30:57.666034) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-29 23:30:57.669711) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7ef9290eda976f4e3e3bc041e9303380f2435ee1ab66a663cccfdd523d38098f1d32b9cc037f524804aa83fc1d6cd24d06da82ad449c0eb2a68724ff1fb0c770", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/d550f5bbdba6d44241b8715e253be30f872ca1489fdd9b3ed81755e0209c8465f66d584979a7780c5cdbedc50c03b793c79416c7365855cf684b9758962b9a4e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/0067bac38444ef0524261d499950944f9b419967f3007b80ebda8688ca17ff51519fc46a34ec38cc7841ef169eaf9944b397cd6faf3d8eea3fb8ec01b2629cc2"} build_url:https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011353 build_url: 'https://queue.taskcluster.net/v1/task/Gg42XsY9QCKBuSzScWRmnA/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/Fx-Team-Non-PGO/sha512/7ef9290eda976f4e3e3bc041e9303380f2435ee1ab66a663cccfdd523d38098f1d32b9cc037f524804aa83fc1d6cd24d06da82ad449c0eb2a68724ff1fb0c770", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/d550f5bbdba6d44241b8715e253be30f872ca1489fdd9b3ed81755e0209c8465f66d584979a7780c5cdbedc50c03b793c79416c7365855cf684b9758962b9a4e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/0067bac38444ef0524261d499950944f9b419967f3007b80ebda8688ca17ff51519fc46a34ec38cc7841ef169eaf9944b397cd6faf3d8eea3fb8ec01b2629cc2"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-29 23:30:57.695825) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 23:30:57.696206) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=826874ccc97bd7bf541b4875000001d5-1467266681.302739-665993628 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004475 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 23:30:57.778319) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-29 23:30:57.778636) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-29 23:30:57.778961) ========= ========= Total master_lag: 1.24 =========