builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-030 starttime: 1467655639.0 results: success (0) buildid: 20160704083032 builduid: 3d4f685104e5484db3f60317dd361951 revision: c8a3e468c15d75538899d2d9f6e2018c13418718 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.002821) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.003312) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.003638) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.048662) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.048977) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-04 11:07:19-- 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% 225M=0s 2016-07-04 11:07:19 (225 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.127850 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.228415) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.228780) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017481 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.262587) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.262951) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev c8a3e468c15d75538899d2d9f6e2018c13418718 --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 c8a3e468c15d75538899d2d9f6e2018c13418718 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-04 11:07:19,388 truncating revision to first 12 chars 2016-07-04 11:07:19,388 Setting DEBUG logging. 2016-07-04 11:07:19,388 attempt 1/10 2016-07-04 11:07:19,388 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/c8a3e468c15d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-04 11:07:19,686 unpacking tar archive at: fx-team-c8a3e468c15d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.664616 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.944849) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.945205) ========= script_repo_revision: c8a3e468c15d75538899d2d9f6e2018c13418718 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.945713) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.946026) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-04 11:07:19.958871) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 29 secs) (at 2016-07-04 11:07:19.959179) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:07:20 INFO - MultiFileLogger online at 20160704 11:07:20 in /builds/slave/test 11:07:20 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 11:07:20 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:07:20 INFO - {'append_to_log': False, 11:07:20 INFO - 'base_work_dir': '/builds/slave/test', 11:07:20 INFO - 'blob_upload_branch': 'Fx-Team', 11:07:20 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:07:20 INFO - 'branch': 'Fx-Team', 11:07:20 INFO - 'buildbot_json_path': 'buildprops.json', 11:07:20 INFO - 'config_files': ('talos/linux_config.py',), 11:07:20 INFO - 'default_actions': ('clobber', 11:07:20 INFO - 'read-buildbot-config', 11:07:20 INFO - 'download-and-extract', 11:07:20 INFO - 'populate-webroot', 11:07:20 INFO - 'create-virtualenv', 11:07:20 INFO - 'install', 11:07:20 INFO - 'run-tests'), 11:07:20 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:07:20 INFO - 'download_minidump_stackwalk': True, 11:07:20 INFO - 'download_symbols': 'ondemand', 11:07:20 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:07:20 INFO - 'tooltool.py': '/tools/tooltool.py', 11:07:20 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:07:20 INFO - '/tools/misc-python/virtualenv.py')}, 11:07:20 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:07:20 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:07:20 INFO - 'installer_path': 'installer.exe', 11:07:20 INFO - 'log_level': 'info', 11:07:20 INFO - 'log_name': 'talos', 11:07:20 INFO - 'log_to_console': True, 11:07:20 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:07:20 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:07:20 INFO - 'opt_config_files': (), 11:07:20 INFO - 'pip_index': False, 11:07:20 INFO - 'sps_profile': False, 11:07:20 INFO - 'sps_profile_interval': 0, 11:07:20 INFO - 'suite': 'dromaeojs-e10s', 11:07:20 INFO - 'system_bits': '32', 11:07:20 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:07:20 INFO - 'title': 'talos-linux64-ix-030', 11:07:20 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:07:20 INFO - 'use_talos_json': True, 11:07:20 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:07:20 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:07:20 INFO - 'work_dir': 'build'} 11:07:20 INFO - ##### 11:07:20 INFO - ##### Running clobber step. 11:07:20 INFO - ##### 11:07:20 INFO - Running pre-action listener: _resource_record_pre_action 11:07:20 INFO - Running main action method: clobber 11:07:20 INFO - rmtree: /builds/slave/test/build 11:07:20 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:07:21 INFO - Running post-action listener: _resource_record_post_action 11:07:21 INFO - ##### 11:07:21 INFO - ##### Finished clobber step (success) 11:07:21 INFO - ##### 11:07:21 INFO - ##### 11:07:21 INFO - ##### Running read-buildbot-config step. 11:07:21 INFO - ##### 11:07:21 INFO - Running pre-action listener: _resource_record_pre_action 11:07:21 INFO - Running main action method: read_buildbot_config 11:07:21 INFO - Using buildbot properties: 11:07:21 INFO - { 11:07:21 INFO - "project": "", 11:07:21 INFO - "product": "firefox", 11:07:21 INFO - "script_repo_revision": "production", 11:07:21 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 11:07:21 INFO - "repository": "", 11:07:21 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 11:07:21 INFO - "buildid": "20160704083032", 11:07:21 INFO - "pgo_build": "True", 11:07:21 INFO - "basedir": "/builds/slave/test", 11:07:21 INFO - "buildnumber": 592, 11:07:21 INFO - "slavename": "talos-linux64-ix-030", 11:07:21 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 11:07:21 INFO - "platform": "ubuntu64_hw", 11:07:21 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:07:21 INFO - "branch": "fx-team", 11:07:21 INFO - "repo_path": "integration/fx-team", 11:07:21 INFO - "revision": "c8a3e468c15d75538899d2d9f6e2018c13418718", 11:07:21 INFO - "stage_platform": "linux64-pgo", 11:07:21 INFO - "builduid": "3d4f685104e5484db3f60317dd361951", 11:07:21 INFO - "slavebuilddir": "test" 11:07:21 INFO - } 11:07:21 INFO - Found installer url https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 11:07:21 INFO - Running post-action listener: _resource_record_post_action 11:07:21 INFO - ##### 11:07:21 INFO - ##### Finished read-buildbot-config step (success) 11:07:21 INFO - ##### 11:07:21 INFO - ##### 11:07:21 INFO - ##### Running download-and-extract step. 11:07:21 INFO - ##### 11:07:21 INFO - Running pre-action listener: _resource_record_pre_action 11:07:21 INFO - Running main action method: download_and_extract 11:07:21 INFO - mkdir: /builds/slave/test/build/tests 11:07:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:21 INFO - https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:07:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:07:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:07:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:07:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 11:07:22 INFO - Downloaded 1361 bytes. 11:07:22 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:07:22 INFO - Using the following test package requirements: 11:07:22 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:07:22 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:07:22 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:07:22 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:07:22 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:07:22 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:07:22 INFO - u'jsshell-linux-x86_64.zip'], 11:07:22 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:07:22 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:07:22 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:07:22 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:07:22 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:07:22 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:07:22 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:07:22 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:07:22 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:07:22 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:07:22 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:07:22 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:07:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:22 INFO - https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:07:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:07:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:07:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:07:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:07:23 INFO - Downloaded 24276067 bytes. 11:07:23 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:07:23 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:07:25 INFO - Return code: 0 11:07:25 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 11:07:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:25 INFO - https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:07:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:07:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:07:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:07:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:07:26 INFO - Downloaded 24276067 bytes. 11:07:26 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:07:26 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:07:27 INFO - Return code: 0 11:07: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')]} 11:07:27 INFO - https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:07:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:07:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:07:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:07:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 11:07:29 INFO - Downloaded 14403333 bytes. 11:07:29 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:07:29 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 11:07:29 INFO - Return code: 0 11:07:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:29 INFO - https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:07:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:07:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:07:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:07:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 11:07:30 INFO - Downloaded 60354375 bytes. 11:07:30 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:07:30 INFO - mkdir: /builds/slave/test/properties 11:07:30 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:07:30 INFO - Writing to file /builds/slave/test/properties/build_url 11:07:30 INFO - Contents: 11:07:30 INFO - build_url:https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:07:31 INFO - Running post-action listener: _resource_record_post_action 11:07:31 INFO - Running post-action listener: set_extra_try_arguments 11:07:31 INFO - ##### 11:07:31 INFO - ##### Finished download-and-extract step (success) 11:07:31 INFO - ##### 11:07:31 INFO - ##### 11:07:31 INFO - ##### Running populate-webroot step. 11:07:31 INFO - ##### 11:07:31 INFO - Running pre-action listener: _resource_record_pre_action 11:07:31 INFO - Running main action method: populate_webroot 11:07:31 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:07:31 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:07:31 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:07:31 INFO - '--tppagecycles', 11:07:31 INFO - '7'], 11:07:31 INFO - 'tests': ['tsvgm']}}, 11:07:31 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:07:31 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:07:31 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:07:31 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:07:31 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:07:31 INFO - 'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:07:31 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:07:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:07:31 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:07:31 INFO - 'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['damp', 'tps']}, 11:07:31 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:07:31 INFO - 'tests': ['damp', 'tps']}, 11:07:31 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['dromaeo_dom']}, 11:07:31 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:07:31 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['basic_compositor_video']}, 11:07:31 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 11:07:31 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['a11yr', 11:07:31 INFO - 'ts_paint', 11:07:31 INFO - 'tpaint', 11:07:31 INFO - 'sessionrestore', 11:07:31 INFO - 'sessionrestore_no_auto_restore', 11:07:31 INFO - 'tabpaint']}, 11:07:31 INFO - 'other-e10s': {'tests': ['a11yr', 11:07:31 INFO - 'ts_paint', 11:07:31 INFO - 'tpaint', 11:07:31 INFO - 'sessionrestore', 11:07:31 INFO - 'sessionrestore_no_auto_restore', 11:07:31 INFO - 'tabpaint']}, 11:07:31 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:07:31 INFO - 'ts_paint', 11:07:31 INFO - 'tpaint', 11:07:31 INFO - 'sessionrestore', 11:07:31 INFO - 'sessionrestore_no_auto_restore', 11:07:31 INFO - 'tabpaint']}, 11:07:31 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:07:31 INFO - 'ts_paint', 11:07:31 INFO - 'tpaint', 11:07:31 INFO - 'sessionrestore', 11:07:31 INFO - 'sessionrestore_no_auto_restore', 11:07:31 INFO - 'tabpaint']}, 11:07:31 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['a11yr', 11:07:31 INFO - 'ts_paint', 11:07:31 INFO - 'tpaint', 11:07:31 INFO - 'sessionrestore', 11:07:31 INFO - 'sessionrestore_no_auto_restore', 11:07:31 INFO - 'tabpaint']}, 11:07:31 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['a11yr', 11:07:31 INFO - 'ts_paint', 11:07:31 INFO - 'tpaint', 11:07:31 INFO - 'sessionrestore', 11:07:31 INFO - 'sessionrestore_no_auto_restore', 11:07:31 INFO - 'tabpaint']}, 11:07:31 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['tsvgx', 11:07:31 INFO - 'tsvgr_opacity', 11:07:31 INFO - 'tart', 11:07:31 INFO - 'tscrollx', 11:07:31 INFO - 'cart']}, 11:07:31 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:07:31 INFO - 'tsvgr_opacity', 11:07:31 INFO - 'tart', 11:07:31 INFO - 'tscrollx', 11:07:31 INFO - 'cart']}, 11:07:31 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:07:31 INFO - 'talos_options': ['--disable-e10s'], 11:07:31 INFO - 'tests': ['tp5o']}, 11:07:31 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:07:31 INFO - 'tests': ['tp5o']}, 11:07:31 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:07:31 INFO - 'talos_options': ['--disable-e10s', 11:07:31 INFO - '--xperf_path', 11:07:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:07:31 INFO - 'tests': ['tp5n']}, 11:07:31 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:07:31 INFO - 'talos_options': ['--xperf_path', 11:07:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:07:31 INFO - 'tests': ['tp5n']}}, 11:07:31 INFO - 'talos.zip': {'path': '', 11:07:31 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:07:31 INFO - Running post-action listener: _resource_record_post_action 11:07:31 INFO - ##### 11:07:31 INFO - ##### Finished populate-webroot step (success) 11:07:31 INFO - ##### 11:07:31 INFO - ##### 11:07:31 INFO - ##### Running create-virtualenv step. 11:07:31 INFO - ##### 11:07:31 INFO - Running pre-action listener: _resource_record_pre_action 11:07:31 INFO - Running main action method: create_virtualenv 11:07:31 INFO - Creating virtualenv /builds/slave/test/build/venv 11:07:31 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 11:07:31 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:07:31 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:07:31 INFO - Using real prefix '/usr' 11:07:31 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:07:32 INFO - Installing distribute.............................................................................................................................................................................................done. 11:07:34 INFO - Installing pip.................done. 11:07:34 INFO - Return code: 0 11:07:34 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:07:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:34 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 11:07:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 11:07:34 INFO - Using env: {'DISPLAY': ':0', 11:07:34 INFO - 'HOME': '/home/cltbld', 11:07:34 INFO - 'LANG': 'en_US.UTF-8', 11:07:34 INFO - 'LANGUAGE': 'en_US:en', 11:07:34 INFO - 'LOGNAME': 'cltbld', 11:07:34 INFO - 'MAIL': '/var/mail/cltbld', 11:07:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:34 INFO - 'MOZ_NO_REMOTE': '1', 11:07:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:34 INFO - 'NO_EM_RESTART': '1', 11:07:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:34 INFO - 'PWD': '/builds/slave/test', 11:07:34 INFO - 'SHELL': '/bin/bash', 11:07:34 INFO - 'SHLVL': '1', 11:07:34 INFO - 'TERM': 'linux', 11:07:34 INFO - 'TMOUT': '86400', 11:07:34 INFO - 'USER': 'cltbld', 11:07:34 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:34 INFO - '_': '/tools/buildbot/bin/python'} 11:07:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:34 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 11:07:34 INFO - Cleaning up... 11:07:34 INFO - Return code: 0 11:07:34 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:07:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:34 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 11:07:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 11:07:34 INFO - Using env: {'DISPLAY': ':0', 11:07:34 INFO - 'HOME': '/home/cltbld', 11:07:34 INFO - 'LANG': 'en_US.UTF-8', 11:07:34 INFO - 'LANGUAGE': 'en_US:en', 11:07:34 INFO - 'LOGNAME': 'cltbld', 11:07:34 INFO - 'MAIL': '/var/mail/cltbld', 11:07:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:34 INFO - 'MOZ_NO_REMOTE': '1', 11:07:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:34 INFO - 'NO_EM_RESTART': '1', 11:07:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:34 INFO - 'PWD': '/builds/slave/test', 11:07:34 INFO - 'SHELL': '/bin/bash', 11:07:34 INFO - 'SHLVL': '1', 11:07:34 INFO - 'TERM': 'linux', 11:07:34 INFO - 'TMOUT': '86400', 11:07:34 INFO - 'USER': 'cltbld', 11:07:34 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:34 INFO - '_': '/tools/buildbot/bin/python'} 11:07:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:34 INFO - Downloading/unpacking psutil>=3.1.1 11:07:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:07:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:07:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:07:36 INFO - Installing collected packages: psutil 11:07:36 INFO - Running setup.py install for psutil 11:07:36 INFO - building 'psutil._psutil_linux' extension 11:07:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 11:07:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 11:07:36 INFO - building 'psutil._psutil_posix' extension 11:07:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 11:07:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 11:07:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:07:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:07:37 INFO - Successfully installed psutil 11:07:37 INFO - Cleaning up... 11:07:37 INFO - Return code: 0 11:07:37 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:07:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:37 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 11:07:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 11:07:37 INFO - Using env: {'DISPLAY': ':0', 11:07:37 INFO - 'HOME': '/home/cltbld', 11:07:37 INFO - 'LANG': 'en_US.UTF-8', 11:07:37 INFO - 'LANGUAGE': 'en_US:en', 11:07:37 INFO - 'LOGNAME': 'cltbld', 11:07:37 INFO - 'MAIL': '/var/mail/cltbld', 11:07:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:37 INFO - 'MOZ_NO_REMOTE': '1', 11:07:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:37 INFO - 'NO_EM_RESTART': '1', 11:07:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:37 INFO - 'PWD': '/builds/slave/test', 11:07:37 INFO - 'SHELL': '/bin/bash', 11:07:37 INFO - 'SHLVL': '1', 11:07:37 INFO - 'TERM': 'linux', 11:07:37 INFO - 'TMOUT': '86400', 11:07:37 INFO - 'USER': 'cltbld', 11:07:37 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:37 INFO - '_': '/tools/buildbot/bin/python'} 11:07:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:37 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:07:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:39 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:07:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:07:39 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:07:39 INFO - Installing collected packages: mozsystemmonitor 11:07:39 INFO - Running setup.py install for mozsystemmonitor 11:07:39 INFO - Successfully installed mozsystemmonitor 11:07:39 INFO - Cleaning up... 11:07:39 INFO - Return code: 0 11:07:39 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:07:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:39 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 11:07:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 11:07:39 INFO - Using env: {'DISPLAY': ':0', 11:07:39 INFO - 'HOME': '/home/cltbld', 11:07:39 INFO - 'LANG': 'en_US.UTF-8', 11:07:39 INFO - 'LANGUAGE': 'en_US:en', 11:07:39 INFO - 'LOGNAME': 'cltbld', 11:07:39 INFO - 'MAIL': '/var/mail/cltbld', 11:07:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:39 INFO - 'MOZ_NO_REMOTE': '1', 11:07:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:39 INFO - 'NO_EM_RESTART': '1', 11:07:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:39 INFO - 'PWD': '/builds/slave/test', 11:07:39 INFO - 'SHELL': '/bin/bash', 11:07:39 INFO - 'SHLVL': '1', 11:07:39 INFO - 'TERM': 'linux', 11:07:39 INFO - 'TMOUT': '86400', 11:07:39 INFO - 'USER': 'cltbld', 11:07:39 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:39 INFO - '_': '/tools/buildbot/bin/python'} 11:07:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:39 INFO - Downloading/unpacking jsonschema==2.5.1 11:07:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:41 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:07:41 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:07:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:41 INFO - Downloading functools32-3.2.3-2.tar.gz 11:07:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:07:41 INFO - warning: no files found matching '*.txt' 11:07:41 INFO - no previously-included directories found matching 'build' 11:07:41 INFO - no previously-included directories found matching 'dist' 11:07:41 INFO - no previously-included directories found matching '.git*' 11:07:41 INFO - Installing collected packages: jsonschema, functools32 11:07:41 INFO - Running setup.py install for functools32 11:07:41 INFO - warning: no files found matching '*.txt' 11:07:41 INFO - no previously-included directories found matching 'build' 11:07:41 INFO - no previously-included directories found matching 'dist' 11:07:41 INFO - no previously-included directories found matching '.git*' 11:07:41 INFO - Successfully installed jsonschema functools32 11:07:41 INFO - Cleaning up... 11:07:42 INFO - Return code: 0 11:07:42 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:07:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:42 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 11:07:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 11:07:42 INFO - Using env: {'DISPLAY': ':0', 11:07:42 INFO - 'HOME': '/home/cltbld', 11:07:42 INFO - 'LANG': 'en_US.UTF-8', 11:07:42 INFO - 'LANGUAGE': 'en_US:en', 11:07:42 INFO - 'LOGNAME': 'cltbld', 11:07:42 INFO - 'MAIL': '/var/mail/cltbld', 11:07:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:42 INFO - 'MOZ_NO_REMOTE': '1', 11:07:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:42 INFO - 'NO_EM_RESTART': '1', 11:07:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:42 INFO - 'PWD': '/builds/slave/test', 11:07:42 INFO - 'SHELL': '/bin/bash', 11:07:42 INFO - 'SHLVL': '1', 11:07:42 INFO - 'TERM': 'linux', 11:07:42 INFO - 'TMOUT': '86400', 11:07:42 INFO - 'USER': 'cltbld', 11:07:42 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:42 INFO - '_': '/tools/buildbot/bin/python'} 11:07:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:42 INFO - Downloading/unpacking blobuploader==1.2.4 11:07: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 11:07: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 11:07: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 11:07: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 11:07: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 11:07: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 11:07:44 INFO - Downloading blobuploader-1.2.4.tar.gz 11:07:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:07:44 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:07:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:07:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:07:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:44 INFO - Downloading docopt-0.6.1.tar.gz 11:07:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:07:44 INFO - Installing collected packages: blobuploader, requests, docopt 11:07:44 INFO - Running setup.py install for blobuploader 11:07:45 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:07:45 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:07:45 INFO - Running setup.py install for requests 11:07:45 INFO - Running setup.py install for docopt 11:07:45 INFO - Successfully installed blobuploader requests docopt 11:07:45 INFO - Cleaning up... 11:07:45 INFO - Return code: 0 11:07:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:07:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:45 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:07:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:07:45 INFO - Using env: {'DISPLAY': ':0', 11:07:45 INFO - 'HOME': '/home/cltbld', 11:07:45 INFO - 'LANG': 'en_US.UTF-8', 11:07:45 INFO - 'LANGUAGE': 'en_US:en', 11:07:45 INFO - 'LOGNAME': 'cltbld', 11:07:45 INFO - 'MAIL': '/var/mail/cltbld', 11:07:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:45 INFO - 'MOZ_NO_REMOTE': '1', 11:07:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:45 INFO - 'NO_EM_RESTART': '1', 11:07:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:45 INFO - 'PWD': '/builds/slave/test', 11:07:45 INFO - 'SHELL': '/bin/bash', 11:07:45 INFO - 'SHLVL': '1', 11:07:45 INFO - 'TERM': 'linux', 11:07:45 INFO - 'TMOUT': '86400', 11:07:45 INFO - 'USER': 'cltbld', 11:07:45 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:45 INFO - '_': '/tools/buildbot/bin/python'} 11:07:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:07:45 INFO - Running setup.py (path:/tmp/pip-T5ck8G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:07:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:07:45 INFO - Running setup.py (path:/tmp/pip-15Mi20-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:07:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:07:45 INFO - Running setup.py (path:/tmp/pip-g5gBF8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:07:46 INFO - Running setup.py (path:/tmp/pip-Qrgzb6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:07:46 INFO - Running setup.py (path:/tmp/pip-KU7WaM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:07:46 INFO - Running setup.py (path:/tmp/pip-2uqNza-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:07:46 INFO - Running setup.py (path:/tmp/pip-k6o9ld-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:07:46 INFO - Running setup.py (path:/tmp/pip-j9Hyz1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:07:46 INFO - Running setup.py (path:/tmp/pip-mqXArJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:07:46 INFO - Running setup.py (path:/tmp/pip-eNb_eq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:07:46 INFO - Running setup.py (path:/tmp/pip-i4cteJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:07:46 INFO - Running setup.py (path:/tmp/pip-5dmFTU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:07:46 INFO - Running setup.py (path:/tmp/pip-MveYR2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:07:46 INFO - Running setup.py (path:/tmp/pip-3cFCiP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:07:46 INFO - Running setup.py (path:/tmp/pip-aZXZM0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:07:46 INFO - Running setup.py (path:/tmp/pip-CrqJ3x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:07:46 INFO - Running setup.py (path:/tmp/pip-7KQun8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:07:47 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:07:47 INFO - Running setup.py install for manifestparser 11:07:47 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Running setup.py install for mozcrash 11:07:47 INFO - Running setup.py install for mozdebug 11:07:47 INFO - Running setup.py install for mozdevice 11:07:47 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Running setup.py install for mozfile 11:07:47 INFO - Running setup.py install for mozhttpd 11:07:47 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Running setup.py install for mozinfo 11:07:47 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Running setup.py install for mozInstall 11:07:47 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:07:47 INFO - Running setup.py install for mozleak 11:07:47 INFO - Running setup.py install for mozlog 11:07:48 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:07:48 INFO - Running setup.py install for moznetwork 11:07:48 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:07:48 INFO - Running setup.py install for mozprocess 11:07:48 INFO - Running setup.py install for mozprofile 11:07:48 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:07:48 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:07:48 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:07:48 INFO - Running setup.py install for mozrunner 11:07:48 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:07:48 INFO - Running setup.py install for mozscreenshot 11:07:48 INFO - Running setup.py install for moztest 11:07:48 INFO - Running setup.py install for mozversion 11:07:48 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:07:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:07:48 INFO - Cleaning up... 11:07:48 INFO - Return code: 0 11:07:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:07:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:48 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:07:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:07:48 INFO - Using env: {'DISPLAY': ':0', 11:07:48 INFO - 'HOME': '/home/cltbld', 11:07:48 INFO - 'LANG': 'en_US.UTF-8', 11:07:48 INFO - 'LANGUAGE': 'en_US:en', 11:07:48 INFO - 'LOGNAME': 'cltbld', 11:07:48 INFO - 'MAIL': '/var/mail/cltbld', 11:07:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:48 INFO - 'MOZ_NO_REMOTE': '1', 11:07:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:48 INFO - 'NO_EM_RESTART': '1', 11:07:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:48 INFO - 'PWD': '/builds/slave/test', 11:07:48 INFO - 'SHELL': '/bin/bash', 11:07:48 INFO - 'SHLVL': '1', 11:07:48 INFO - 'TERM': 'linux', 11:07:48 INFO - 'TMOUT': '86400', 11:07:48 INFO - 'USER': 'cltbld', 11:07:48 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:48 INFO - '_': '/tools/buildbot/bin/python'} 11:07:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:07:49 INFO - Running setup.py (path:/tmp/pip-624olv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:07:49 INFO - Running setup.py (path:/tmp/pip-ITdAK9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:07:49 INFO - Running setup.py (path:/tmp/pip-eyCC0o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:07:49 INFO - Running setup.py (path:/tmp/pip-wdfImG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:07:49 INFO - Running setup.py (path:/tmp/pip-hjgDPU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:07:49 INFO - Running setup.py (path:/tmp/pip-NekvPI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:07:49 INFO - Running setup.py (path:/tmp/pip-5Uz9bh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:07:49 INFO - Running setup.py (path:/tmp/pip-miWE3j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:07:49 INFO - Running setup.py (path:/tmp/pip-aW0EP4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:07:49 INFO - Running setup.py (path:/tmp/pip-yqxyU4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:07:49 INFO - Running setup.py (path:/tmp/pip-TOiCKQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:07:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:07:49 INFO - Running setup.py (path:/tmp/pip-BeNkZM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:07:49 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)) 11:07:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:07:49 INFO - Running setup.py (path:/tmp/pip-W5rkEY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 11:07:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:07:50 INFO - Running setup.py (path:/tmp/pip-4fpJoL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:07:50 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)) 11:07:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:07:50 INFO - Running setup.py (path:/tmp/pip-0hz483-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 11:07:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:07:50 INFO - Running setup.py (path:/tmp/pip-LInPK3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 11:07:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:07:50 INFO - Running setup.py (path:/tmp/pip-9FFba3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:07:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:07:50 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:07:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:07:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:07:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:07:52 INFO - Downloading blessings-1.6.tar.gz 11:07:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:07:52 INFO - Installing collected packages: blessings 11:07:52 INFO - Running setup.py install for blessings 11:07:52 INFO - Successfully installed blessings 11:07:52 INFO - Cleaning up... 11:07:52 INFO - Return code: 0 11:07:52 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:07:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:07:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:07:52 INFO - Reading from file tmpfile_stdout 11:07:52 INFO - Current package versions: 11:07:52 INFO - argparse == 1.2.1 11:07:52 INFO - blessings == 1.6 11:07:52 INFO - blobuploader == 1.2.4 11:07:52 INFO - docopt == 0.6.1 11:07:52 INFO - functools32 == 3.2.3-2 11:07:52 INFO - jsonschema == 2.5.1 11:07:52 INFO - manifestparser == 1.1 11:07:52 INFO - mozInstall == 1.12 11:07:52 INFO - mozcrash == 0.17 11:07:52 INFO - mozdebug == 0.1 11:07:52 INFO - mozdevice == 0.48 11:07:52 INFO - mozfile == 1.2 11:07:52 INFO - mozhttpd == 0.7 11:07:52 INFO - mozinfo == 0.9 11:07:52 INFO - mozleak == 0.1 11:07:52 INFO - mozlog == 3.2 11:07:52 INFO - moznetwork == 0.27 11:07:52 INFO - mozprocess == 0.22 11:07:52 INFO - mozprofile == 0.28 11:07:52 INFO - mozrunner == 6.11 11:07:52 INFO - mozscreenshot == 0.1 11:07:52 INFO - mozsystemmonitor == 0.3 11:07:52 INFO - moztest == 0.7 11:07:52 INFO - mozversion == 1.4 11:07:52 INFO - psutil == 3.1.1 11:07:52 INFO - requests == 1.2.3 11:07:52 INFO - wsgiref == 0.1.2 11:07:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:07:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:52 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 11:07:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:07:52 INFO - Using env: {'DISPLAY': ':0', 11:07:52 INFO - 'HOME': '/home/cltbld', 11:07:52 INFO - 'LANG': 'en_US.UTF-8', 11:07:52 INFO - 'LANGUAGE': 'en_US:en', 11:07:52 INFO - 'LOGNAME': 'cltbld', 11:07:52 INFO - 'MAIL': '/var/mail/cltbld', 11:07:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:52 INFO - 'MOZ_NO_REMOTE': '1', 11:07:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:52 INFO - 'NO_EM_RESTART': '1', 11:07:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:52 INFO - 'PWD': '/builds/slave/test', 11:07:52 INFO - 'SHELL': '/bin/bash', 11:07:52 INFO - 'SHLVL': '1', 11:07:52 INFO - 'TERM': 'linux', 11:07:52 INFO - 'TMOUT': '86400', 11:07:52 INFO - 'USER': 'cltbld', 11:07:52 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:52 INFO - '_': '/tools/buildbot/bin/python'} 11:07:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 11:07:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 11:07:52 INFO - Cleaning up... 11:07:52 INFO - Return code: 0 11:07:52 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:07:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:07:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:07:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:07:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:07:52 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 0x1c0f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d728a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ed0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:07:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 11:07:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 11:07:52 INFO - Using env: {'DISPLAY': ':0', 11:07:52 INFO - 'HOME': '/home/cltbld', 11:07:52 INFO - 'LANG': 'en_US.UTF-8', 11:07:52 INFO - 'LANGUAGE': 'en_US:en', 11:07:52 INFO - 'LOGNAME': 'cltbld', 11:07:52 INFO - 'MAIL': '/var/mail/cltbld', 11:07:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:07:52 INFO - 'MOZ_NO_REMOTE': '1', 11:07:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:07:52 INFO - 'NO_EM_RESTART': '1', 11:07:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:07:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:07:52 INFO - 'PWD': '/builds/slave/test', 11:07:52 INFO - 'SHELL': '/bin/bash', 11:07:52 INFO - 'SHLVL': '1', 11:07:52 INFO - 'TERM': 'linux', 11:07:52 INFO - 'TMOUT': '86400', 11:07:52 INFO - 'USER': 'cltbld', 11:07:52 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:07:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:07:52 INFO - '_': '/tools/buildbot/bin/python'} 11:07:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:07:53 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:07:53 INFO - Cleaning up... 11:07:53 INFO - Return code: 0 11:07:53 INFO - Running post-action listener: _resource_record_post_action 11:07:53 INFO - Running post-action listener: _start_resource_monitoring 11:07:53 INFO - Starting resource monitoring. 11:07:53 INFO - ##### 11:07:53 INFO - ##### Finished create-virtualenv step (success) 11:07:53 INFO - ##### 11:07:53 INFO - ##### 11:07:53 INFO - ##### Running install step. 11:07:53 INFO - ##### 11:07:53 INFO - Running pre-action listener: _resource_record_pre_action 11:07:53 INFO - Running main action method: install 11:07:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:07:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:07:53 INFO - Reading from file tmpfile_stdout 11:07:53 INFO - Detecting whether we're running mozinstall >=1.0... 11:07:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:07:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:07:53 INFO - Reading from file tmpfile_stdout 11:07:53 INFO - Output received: 11:07:53 INFO - Usage: mozinstall [options] installer 11:07:53 INFO - Options: 11:07:53 INFO - -h, --help show this help message and exit 11:07:53 INFO - -d DEST, --destination=DEST 11:07:53 INFO - Directory to install application into. [default: 11:07:53 INFO - "/builds/slave/test"] 11:07:53 INFO - --app=APP Application being installed. [default: firefox] 11:07:53 INFO - mkdir: /builds/slave/test/build/application 11:07:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 11:07:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 11:08:10 INFO - Reading from file tmpfile_stdout 11:08:10 INFO - Output received: 11:08:10 INFO - /builds/slave/test/build/application/firefox/firefox 11:08:10 INFO - Running post-action listener: _resource_record_post_action 11:08:10 INFO - ##### 11:08:10 INFO - ##### Finished install step (success) 11:08:10 INFO - ##### 11:08:10 INFO - ##### 11:08:10 INFO - ##### Running run-tests step. 11:08:10 INFO - ##### 11:08:10 INFO - Running pre-action listener: _resource_record_pre_action 11:08:10 INFO - Running main action method: run_tests 11:08:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:08:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:08:10 INFO - Python 2.7.3 11:08:10 INFO - Return code: 0 11:08:10 INFO - grabbing minidump binary from tooltool 11:08:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:08: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 0x1ece3b0>, '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 0x1ecf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ecf740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:08: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 11:08: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 11:08: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 11:08:10 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:08:10 INFO - Return code: 0 11:08:10 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:08:10 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:08:10 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:08:10 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:08:10 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:08:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 11:08:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-030 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 11:08:10 INFO - Using env: {'DISPLAY': ':0', 11:08:10 INFO - 'HOME': '/home/cltbld', 11:08:10 INFO - 'LANG': 'en_US.UTF-8', 11:08:10 INFO - 'LANGUAGE': 'en_US:en', 11:08:10 INFO - 'LOGNAME': 'cltbld', 11:08:10 INFO - 'MAIL': '/var/mail/cltbld', 11:08:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:08:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:08:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:08:10 INFO - 'MOZ_NO_REMOTE': '1', 11:08:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:08:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:08:10 INFO - 'NO_EM_RESTART': '1', 11:08:10 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:08:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:08:10 INFO - 'PWD': '/builds/slave/test', 11:08:10 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:08:10 INFO - 'SHELL': '/bin/bash', 11:08:10 INFO - 'SHLVL': '1', 11:08:10 INFO - 'TERM': 'linux', 11:08:10 INFO - 'TMOUT': '86400', 11:08:10 INFO - 'USER': 'cltbld', 11:08:10 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840', 11:08:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:08:10 INFO - '_': '/tools/buildbot/bin/python'} 11:08:10 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 11:08:10 INFO - mozversion application_buildid: 20160704083032 11:08:10 INFO - mozversion application_changeset: c8a3e468c15d75538899d2d9f6e2018c13418718 11:08:10 INFO - mozversion application_display_name: Nightly 11:08:10 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:08:10 INFO - mozversion application_name: Firefox 11:08:10 INFO - mozversion application_remotingname: firefox 11:08:10 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:08:10 INFO - mozversion application_vendor: Mozilla 11:08:10 INFO - mozversion application_version: 50.0a1 11:08:10 INFO - mozversion platform_buildid: 20160704083032 11:08:10 INFO - mozversion platform_changeset: c8a3e468c15d75538899d2d9f6e2018c13418718 11:08:10 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:08:10 INFO - mozversion platform_version: 50.0a1 11:08:10 INFO - using testdate: 1467655690 11:08:10 INFO - actual date: 1467655690 11:08:10 INFO - starting webserver on 'localhost:41368' 11:08:10 INFO - SUITE-START | Running 2 tests 11:08:10 INFO - TEST-START | dromaeo_css 11:08:10 INFO - operating with platform_type : linux_ 11:08:10 INFO - Initialising browser for dromaeo_css test... 11:08:10 INFO - TEST-INFO | started process 22419 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpht1o2j/profile http://localhost:41368/getInfo.html) 11:08:15 INFO - PROCESS | 22419 | __metrics Screen width/height:1600/1200 11:08:15 INFO - PROCESS | 22419 | colorDepth:24 11:08:15 INFO - PROCESS | 22419 | Browser inner width/height: 1024/697 11:08:15 INFO - PROCESS | 22419 | __metrics 11:08:15 ERROR - PROCESS | 22419 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 11:08:16 INFO - TEST-INFO | 22419: exit 0 11:08:16 INFO - Browser initialized. 11:08:16 INFO - Running cycle 1/1 for dromaeo_css test... 11:08:16 INFO - TEST-INFO | started process 22539 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpht1o2j/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:08:28 INFO - PROCESS | 22539 | RSS: Main: 168980480 11:08:28 INFO - PROCESS | 22539 | 11:09:18 INFO - PROCESS | 22539 | 1467655758210 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] 11:11:26 INFO - PROCESS | 22539 | Cycle 1(1): loaded http://localhost:41368/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41368/tests/dromaeo/cssquery-ext.html) 11:11:27 INFO - PROCESS | 22539 | RSS: Main: 172052480 11:11:27 INFO - PROCESS | 22539 | 11:14:29 INFO - PROCESS | 22539 | Cycle 1(1): loaded http://localhost:41368/tests/dromaeo/cssquery-ext.html (next: http://localhost:41368/tests/dromaeo/cssquery-jquery.html) 11:14:30 INFO - PROCESS | 22539 | RSS: Main: 169074688 11:14:30 INFO - PROCESS | 22539 | 11:17:32 INFO - PROCESS | 22539 | Cycle 1(1): loaded http://localhost:41368/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41368/tests/dromaeo/cssquery-mootools.html) 11:17:32 INFO - PROCESS | 22539 | RSS: Main: 172310528 11:17:32 INFO - PROCESS | 22539 | 11:20:34 INFO - PROCESS | 22539 | Cycle 1(1): loaded http://localhost:41368/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41368/tests/dromaeo/cssquery-prototype.html) 11:20:35 INFO - PROCESS | 22539 | RSS: Main: 167612416 11:20:35 INFO - PROCESS | 22539 | 11:23:37 INFO - PROCESS | 22539 | Cycle 1(1): loaded http://localhost:41368/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41368/tests/dromaeo/cssquery-yui.html) 11:23:38 INFO - PROCESS | 22539 | RSS: Main: 169259008 11:23:38 INFO - PROCESS | 22539 | 11:26:40 INFO - PROCESS | 22539 | Cycle 1(1): loaded http://localhost:41368/tests/dromaeo/cssquery-yui.html (next: http://localhost:41368/tests/dromaeo/cssquery-dojo.html) 11:26:41 INFO - PROCESS | 22539 | RSS: Main: 171048960 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - PROCESS | 22539 | __start_tp_report 11:26:41 INFO - PROCESS | 22539 | _x_x_mozilla_page_load 11:26:41 INFO - PROCESS | 22539 | _x_x_mozilla_page_load_details 11:26:41 INFO - PROCESS | 22539 | |i|pagename|runs| 11:26:41 INFO - PROCESS | 22539 | |0;dojo.html;3123.9375212495747;3143.5127555228946;3165.1928758166664;3183.331500384919;3191.425543402188;5410.51305382516;5417.133258678612;5468.863278418036;5543.085390910495;5551.8889622207535;5274.92087618686;5382.407935127133;5395.59533035022;5451.236826844245;5560.443955604448;4860.319555262275;4889.535494128052;4989.525995030466;5056.544910958013;5100.132977393852;800.6450861616278;4899.387576552931;4908.0429316283335;4917.532834380746;5063.645544811865;4919.508049195069;4948.950510494885;4958.380202474691;4962.776675049613;4971;4984.277279794445;4984.900301993976;4993.051320249141;4996.150654388763;5006.674566153189;4868.95131048692;4887.584555312767;4927.433345165316;4956.107900577895;4972.8756781080765;5372.167314066326;5454.372747134091;5457.754401051962;5459.12653975362;5518.2826232589905;5572.665640061609;5697.4302569742695;5805.042168042268;5859.560532960045;5862.237909071836;5785.1611516329895;5824.650520968756;5834.562407819388;5861.2087368205175;5897.0859516774535;5440.156775699773;5448;5456.236126942231;5467.9453205467835;5472.015037293286;5725.799597014085;5925.4370834770625;5931.051031834886;5940.70296485174;5950.285965684146;5738.196652468658;5742.54059675225;5752.36723960364;5760.913586296209;5775.104858746901;5869.236999190078;5881.2942446906645;5882.911756323659;5883.411658834082;5898.174255604219;5766.452187042224;5813.447722466359;5836.270466191726;5861.6189947653265;5867.618604790675;5778.913316300259;5853.356130825606;5854.619449735838;5867.354590994987;5877.324107727666;4393.165298593257;4453.376527286183;4474.194644963873;4512.300593408027;4534.274516077412;3922.941155882664;3941.546722126992;3980.20395920817;4012.7792971386853;4014.759114453142;5665.405132461115;5692.373838877803;5695.775408287155;5719.542436605062;5732.799352022659;5757.88484230313;5947.613405128739;5950.166976623276;5959.255093113361;5992;5602.2717046783655;5619.381867994517;5627.831165065055;5642.576806739429;5643.097104463266;5001.199808030698;5042.596592272609;5081.415637201695;5106.617003724736;5109.744512774347;5926.111083337448;6057.42454466825;6089.360617135226;6149.292831324366;6158.538109641705;5899.144624029492;5977.073553599199;5980.37206093354;5989.790357337472;6000.189974353581;6162.630242185483;6189.288231853395;6192.349803270772;6194.5044396449075;6198.969005154945;5695.487406133302;5736.770529178953;5806.2451881255165;5818.2436283282905;5828.533717302521;5939.227900372924;5960.195373624505;5963;5966.134910438049;6001.939980600138;5798.478136967525;5801;5808.128780682931;5816.796412125555;5823.82528524145;5646.971765141148;5661.745221465127;5680.346760122638;5695.971520142539;5761.769529218785;5637.774489020393;5667.093265077568;5667.518260947865;5675.602707810413;5678.14827775837;5711.228984087095;5734.254546908875;5791.391903850204;5796.768129274782;5808.796692115756;5594.916076258941;5648.971755141198;5665.830025099089;5672.971635141798;5693.572982026281 11:26:41 INFO - PROCESS | 22539 | |1;ext.html;571.745573219917;613.426446272735;626.2922897126244;634.3529599808194;661.1867403094191;40515.59484405155;41830.37254441186;45619.77190114053;45822.541774582205;45908.54091459084;46111;46297;46463.30305045418;46499.767501162445;46652.3002154968;8941.50821704806;8983.281337493017;9015.504147271897;9035.051319611444;9058.456492610465;8899.110088991114;8968.820623587524;8971.820563588724;9013.54932253388;9013.819723605524;9039.457632542035;9056.230220431271;9065;9083.227925626297;9094.63621455141;8990.730278091667;9023.007469178385;9039.457632542035;9060.728178154666;9076.727698169065;8899.332550058707;8925.776855578597;8946.776330591721;8953.776155596097;8958.193762561335;32598.674013259802;43659;43828.123437531074;44074.559254407366;44169.33745993813;3290.457074582691;3328.8169150696704;3404.302118065815;3491.773034752758;3654.5797233317976;31012.37975240505;31366.843165784026;31480;31750.682493175005;32797;4091.509018917719;4114.238865809834;4126.223208272258;4217.725847819882;4302.290122129845;316259.9999999977;318028;318056;318378;318505;35657.10857228538;35701.8214908929;35827.641723582434;36068.45897311543;36092.639073609454;33919.83040084833;34400;34543.30913381718;36468.08829779277;36965.63034369622;17671.469855904088;17794.822051779574;18065.7290140648;18082.186301616457;18118;12681.112322137362;12746.745065098647;12781.872181278255;12812.61562153137;12836.037297202747;20081.29715459952;20194.29319973794;20345.796542034685;20407.4898127548;20411.8979405105;7442.479026468095;7467.178610352857;7482.47622666419;7575.128860181039;7587.772366829004;925.6575067225169;1046.884842667306;1051.9684409467727;1067.503610820972;1108.2740804772886;33158.66841331556;33564.49653255203;33669.326613467594;33820.32359352799;34114.4179861116;1082.1396989393452;1112.9944350278197;1161.4367031989477;1184.9289042657467;1197.024425093546;17410.21654025572;17703.20335584876;17746.37887673925;17812.37656682036;17843;581433;595307;596324;596384;598158;59333.70333148393;60277.69861150754;60755.39244607586;60766.69616651977;60787.69606152029;1328.2893651896381;1343.4424713743688;1354.830646169209;1359.8436179839248;1361.3057340756088;30895.536566951963;32947;32955.67044329526;33065.834670826494;33104.50343244901;52813.73593132164;53232.467675324304;53269.200961986375;53367.46632533625;53491;478778;482590;484105;484218;486203;28809.56785648175;28876;29072.709272907847;29144.7085529142;29291.41417171602;49168.50831491639;49545;49894.251586226965;50787.23819142642;51240;41455.7927210362;42420.36369454522;42423;43737.343939841565;44171.337429937936;42021.36967945544;42756.57243427526;43921.56078439303;44000.33999489946;44006.55993440025;42481.36277955771;43137.56862431335;43665.78167109144;43683.344749828146;43851.78074109609;36278.45582316215;37755;38182.23635527329;38503.61496385113;39001;28829.135125946254;28946.27634309159;29062.854685726437;29267.268318292212;29377.853110734308 11:26:41 INFO - PROCESS | 22539 | |2;jquery.html;383.6719604737951;389.5578518381636;407.31977597412316;410.67556630262084;422.9492460904692;18897.338593149227;20545.794542054577;20789.68815467767;20851.791482085155;21014;18400.631987360244;18452.907735461304;19270.51823704408;19789;19805;5730.828075157752;5845.269341332344;5948.910766338508;5961.403859614047;5971.164037034819;5866.208061911651;5920.674362910038;5931.051031834907;5932.644041357511;5961.1058341248945;6277;6575.375339342779;6585.37438943302;6654.600723956554;6701.128853249071;6332.398422149911;6436.967815160941;6470.935290647104;6496.317886621931;6560.376764207393;5649.983003059448;5656.208130861683;5664.915026274609;5690.061139911951;5696.63280812602;13754.724905501935;14347;23064.846757662217;24249.515009699706;24457.143999959917;2287.359539328974;2351.294611616508;2369.383960170368;2427.7936375408112;2889.2921234297523;10422.21833362501;10536;10670.51982660782;10881.564737410574;10942.671719848417;1815.5007372972539;1945.2510783348512;1958.9706154407695;1986.1261045140236;1997.2310660395708;80237;90418;91286;93290;93541;10857.619983300547;10983.890161098447;11023.944880275547;11056.889431105586;11074.866971909418;14709.338079786436;14799.63000924964;14883.107013579003;14890.106593604418;14906.850931490546;8088.71689490865;8463.15368463161;8516.8722469163;8537.18896704812;8553.44402613828;8315.916840831514;8316;8333.33333333332;8388.748337549883;8510;4508.256137737302;4558.954410455919;4618.030213655103;4619.815207391734;4773.164696178155;1974.8420126389854;2017.2233690029445;2029.4216148397636;2031.6343058249656;2063.886486243241;917.9082091790901;969.5636963366513;981.4356744871727;1007.1388962437011;1022.8874823769379;19855;20109;20141.295054673017;20316.593668126556;20340.69488957667;1035.3322107240788;1038.8493668418037;1067.8291473364225;1082.2910993299402;1087.456271864068;10680.412577308323;11172.44137793107;11191.832122518006;11202.719932001764;11212.66362009141;359916;367128;369069;478094;478466;61646.691766540884;106335.46832265789;111160.44419777849;114211;115219;1045.5295117197293;1057.629829559648;1070.7911957168278;1101.5593762495066;1104.0615476844778;17835.73246401331;18319.35882244115;18340.72488912694;18682.439526814218;19001.904990475512;44408;44983.77508112438;44995;45058;46295.07409851851;58271.83456330934;58714;60391.69804150951;61924;62109;7221.855562888818;7911.734122540366;9121.087891211091;9242.12199841014;9369.344145909721;12428.378581070729;13817.723645527234;14106.36521356562;14192.716145677236;14244.07413518118;12143.089268304735;12407.93796031014;12518.93740531328;12522.499100035897;12559.87440125587;11806.527738890349;12373.62879113628;12393.690157745768;12738.808917866054;12926.676833079247;12817.487300508248;12956.157849739737;12958.740825183631;13048.54330098442;13051.477940882258;9176.724698259062;9198.632054717737;9262.351635385457;9281.118293762082;9500.334976551576;12357;12863.22820630765;12869;12875;12909.677258068623 11:26:41 INFO - PROCESS | 22539 | |3;mootools.html;1378.393506856983;1463.6121427821627;1541.452784261587;1750.3086280919028;1768.3899054826097;7653;8130.390220733454;8398.370122240833;9097.727068187949;9103.317251206161;8188.2630563249295;8483.321334293258;8501.319894408449;8542.91457085429;8547.529885856275;2299.7585253548386;2342.1802369170823;2347.5187586544716;2353.870537120458;2360.0205914545445;2365.136725095345;2371.703537057868;2407.5786737320987;2411.336882357357;2417.2023232333377;2380.8333416660753;2390.8924098415528;2401.399650087478;2401.4236583220077;2406.9398265043337;2315.4790172211287;2316.420894776306;2326.639370897514;2330.906763729449;2345.2846881701075;2305.9308220753237;2311.4683622766856;2319.6404557293477;2334.5447637710654;2344.0155134843235;8694;8704.695335663222;8785.604647790864;8787.736367908972;8801.647934082694;5088.338515992934;5114.872128196787;5125.743712814382;5135.922961155586;5347.278117454132;3434.3989801784587;3484.1289677580603;3527.2592755521373;3534.734894882894;3561.821908904544;1058.4496062047692;1066.6000249906285;1076.7631121153333;1170.8536432945882;1173.3722458484756;12726.981841452662;12737.808932865923;12762.489500419972;12847.614571562868;12941.547045853444;4531.614812740954;4640.489546149921;4677.4854765975715;4681.742504162304;4944.8763780905765;10514.842277365846;10523;10540.104091152185;10540.262181647364;10555.208359373079;5512.448755124456;5577.442255774471;5598.384177740445;5601.803936862272;5608.859778505488;4319.762413067311;4788.449328327218;4909.091818013679;4931.161702510582;5055.545000949932;3983.203359328146;4032.2540330039037;4051.3922911562913;4082.3672330788777;4113.794310284474;1269.6254604891578;1322.0745478165322;1324.0996122636507;1327.1373607155426;1331.467413034794;872.5070335260557;972.0376826941418;1016.7305663999047;1026.9383836969657;1032.2774058159318;5933.3473317934995;6033.642430453113;6074.362191969868;6144.56988010835;6163.7842675506145;449.19593926871187;453.31323045585304;455.398873486994;472.23733670122505;472.27270004193156;4226.85206017794;4314.71954322968;4342.913141737147;4381.123775244963;4435.046465010038;10860.456977151269;11337.489812958436;11338.319700817978;11347.716307092223;11369.09047276216;11294;11312.321260724382;11320.26418282809;11322.94338528302;11347.829782553268;7817.57003364809;8111.918880811234;8117.837643247102;8142.51144931306;8289.792755181168;6006.549508786946;6137.202163718688;6258.217722784652;6322.841928951813;6478.28738838718;9926.801463970536;9933;10012.249081319076;10059.69820905374;10118.544665489924;9893.208543316374;10007.849882251918;10208;10266.948665256627;10299.609552710288;7079.646017699198;7513.4740568159705;7582.696692132253;7585;7779.961100194463;8579.442336248125;8633.95683021606;8656.22094011542;8692.91307086921;8789.956050219707;7441.4418918582405;7776.222377762178;7785.610719464117;8015.318697910743;8043.235892590194;7669.079710434784;7803.258690424401;7846.136924938366;7952.204779522233;7970.043594768433;7269.164046134762;7315.3781928534545;7354.852902941804;7374.520656157332;7380.77857664271;5130.435652078194;5149.536541711264;5151.793928242828;5193.844184674465;5226.163813789775;5244.685318880879;5315.043292207285;5326.6537675050995;5329.09405401075;5401.054815407209 11:26:41 INFO - PROCESS | 22539 | |4;prototype.html;320.24741856636894;326.24311597094743;327.3436759297609;327.6690542552023;334.18792334626875;5477.616566840323;5499.917501237484;5606.187102870082;5627.887442251158;5694.857628559283;5528.834134975947;5561.110222364423;5568.1647752837;5585.916211256825;5586.804461843836;4389.978050109761;4410.338449232609;4413.587651951377;4417.11657668466;4424.535423780505;4109.445224894645;4342.97828510857;4349.673774466912;4428.446444194476;4431.756253406062;4262.593344196408;4268.466441694788;4277.935830962538;4302.397664326981;4306.181825453154;4292.785360731982;4294.312909934411;4304.031592891605;4320.395144679747;4344.934825977582;3717.1822199116423;3734.739040704169;3803.4675145479655;3803.9429408558894;3811.313963486571;5420.208592574827;5431.565474762049;5434.157705555645;5455.945440545584;5471.23402723619;4947.183714687072;4994.126027945132;5010.248462730583;5010.248462730619;5036.445990940993;5615.848751006075;5893.852653683693;5911.467967882912;5921.792737254218;5932.644041357489;4172.749635021908;4184.7070705050655;4193.916121677549;4196.412502249687;4201.411802347674;6048.854595610302;6056.9697151513965;6080.604760690541;6098.420650038239;6105.725242364104;4165.354370072643;4250.681198910032;4261.595148460891;4266.31738921771;4289.506706728766;4284.493571260785;4298.968247620611;4326.718763280377;4329.718568293051;4334.699590123014;4956.132676781549;4956.231784073474;4975.800967961313;4989.55094041538;4995.125852975715;5707.571932105108;5843.853903652443;5900.757712069386;5908.586398952032;5953.374895635982;1451.5935538049364;1475.76387777955;1481.7257158843602;1485.8737007354496;1495.9102453852586;898.9775255618531;919.3105171121658;920;931.4411353188033;938;5092.745362731848;5105.744712764347;5136.2552429898205;5142.151544995034;5156.92264616031;5184.092783762826;5335.413104558495;5340.786368545215;5361;5405.675659460445;5050.924236136461;5076.44159142494;5076.7207803571155;5323.813666521653;5801.419858014165;3207.2142325130494;3219.211293233173;3222.4038552867796;3231.337575796956;3243.935121297608;6123.8162855114415;6196.504279657616;6211.478187844007;6223.533235007392;6259.248890133122;6135.380125725843;6175.814725558241;6176.413240742122;6177.413145751147;6184.804394439999;6244.906326405107;6294.937050629526;6308.179936608211;6314.747410103636;6344.49244060474;5842.941570584239;6043.637381757108;6049.153118563493;6050.364711705208;6074.967255566476;5984.1323008164445;5985.670788106696;6009.549283803644;6022.8795424090395;6025.307089684742;5989.940100598938;6289.245290565162;6290.937090629035;6299;6337;4265.722728022669;4271.466066741657;4285.250081235834;4290.849820256401;4296.076343586144;6095.238095238095;6103.206583144163;6109.266887973472;6117;6129.724162412613;5674.460926212003;5883.970580147072;5913.497352725067;5919.6152250103605;5929.822105336847;5853.765849365977;5896.616719913192;5906.232189815469;5921.881562368814;5978.880422391615;5707.516045828032;5751.4536119068625;5826.82519524415;5832.883342333044;5861.6189947653265;5925.652006616248;5928.851778705567;5941.1088336749835;5952.315483719254;5966.435676707236;5806.912896306474;5821.563382746395;5821.79623713168;5849.268841394825;5855.619384739978 11:26:41 INFO - PROCESS | 22539 | |5;yui.html;730.0728075344313;734.8860926556384;742.1650643026595;744.430510659346;779.6686408276482;14880.553583392488;15889.364425422984;15889.761653575177;15963.600909977256;17152.82847171528;13428.261445620486;13524.120932139404;13547.525836595722;13591.38838752256;13652.658683532916;655.4657953767664;774.0981756253957;788.1724189600897;789.2975252025702;793.111714879336;796.6972550430828;804.7143264141233;805.5207151744703;807.7617102954613;808.7856717969743;857.3955361470148;857.901341345747;860.8751730999002;861.7285555050171;863.8704194370863;848.6817443458702;853.5177624642057;853.607340623314;855.2003876375578;858.1761508951414;623.3890787028691;625.4277336237337;625.8654389306275;627.4603840696997;629.5750368501243;15053.849461505355;15071.321790519452;15100.244987750679;15123.697526049418;15206.16366099864;15871.28579213938;15988.52034438957;16029.679406411922;16190.271437785328;16265.430709925096;11990.14318220213;12040.81938770919;12165.939170304091;12194.451249693786;12353.505859765599;4000.6399424051974;4005.959940400588;4019.075612609087;4124.793760312003;4137.668986481074;84189.57905210435;85041.32272724998;86082.56958715167;87011.56494217488;87366.99999999936;11360.318380897173;11499.999999999833;11508.53965841357;11538.76922461563;11574.768504629861;21258.681119783214;21293;21496.14015439396;21552.56894862094;21596.244131455325;8056.7180148694515;8265.586720663943;8320.126386729427;8343.8331233375;8373.204545568162;4740.905181896412;4746.928796068062;4779.713217206979;4795.520447955177;4906.092372911023;3455.87904423344;3569.5716514018486;3585.982070089633;3589.730770192246;3602.2615363850346;565.4712843491349;586.4985437451003;587.5916238214486;598.099859711132;614.6865098799644;553.7535796570568;636.8216899268213;646.7348387161242;669.3473862983552;688.198249039873;8784.341174411944;8826.955865220762;8842.602082906285;8931.508767017747;9010.234130099016;534.156033467121;614.2444792904663;666.8732940741244;696.6273043921477;702.8453740177152;4100;4181.1010632714115;4215.093754842662;4314.266574682311;4340.414044104005;118439;123895.38052309681;124193.37903310606;126348;128457.35771321083;60173.699131504065;78674;102528.48735756423;102730.2406271403;103490;75012.62493687497;87601.12398876058;88064;89236.55381723179;95414;8168.264856162737;8238.752837414888;8296.460730052528;8761.167689069529;8825.91174088251;53386.733066335975;53721;53887;54679.17981230364;56337.35372459906;73562;80513.59743201481;81125;81757.59121204355;81857;10589.576416943237;11095.16786241019;11161.776764464828;11196.94401527987;11609.419529023346;12563.685907852378;12655.557055503014;12686.238825670489;12892;13200.884098641338;11251.268667536584;11281.605143819927;11468.94265528667;11842.230255033395;11924.344161071225;11568.826467603161;11895.940520297343;12140.75718485643;12509.124361294622;12588.559400420942;11463.598774042868;11781.823272651089;13342.666433339244;13413;13940.163590184622;11388.487518061873;11745.236559623598;11935.582254621047;11955.282683038698;12056.457459414172;10921.508532115915;11459.484323205643;11840.526378944745;11874.881251187378;12055.638330850088 11:26:41 INFO - PROCESS | 22539 | __end_tp_report 11:26:41 INFO - PROCESS | 22539 | __start_cc_report 11:26:41 INFO - PROCESS | 22539 | _x_x_mozilla_cycle_collect,359 11:26:41 INFO - PROCESS | 22539 | __end_cc_report 11:26:41 INFO - PROCESS | 22539 | __startTimestamp1467656801046__endTimestamp 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - PROCESS | 22539 | ------- Summary: start ------- 11:26:41 INFO - PROCESS | 22539 | Number of tests: 6 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - PROCESS | 22539 | [#0] dojo.html Cycles:165 Average:5426.17 Median:5680.35 stddev:727.52 (12.8%) stddev-sans-first:706.98 11:26:41 INFO - PROCESS | 22539 | Values: 3123.9 3143.5 3165.2 3183.3 3191.4 5410.5 5417.1 5468.9 5543.1 5551.9 5274.9 5382.4 5395.6 5451.2 5560.4 4860.3 4889.5 4989.5 5056.5 5100.1 800.6 4899.4 4908.0 4917.5 5063.6 4919.5 4949.0 4958.4 4962.8 4971.0 4984.3 4984.9 4993.1 4996.2 5006.7 4869.0 4887.6 4927.4 4956.1 4972.9 5372.2 5454.4 5457.8 5459.1 5518.3 5572.7 5697.4 5805.0 5859.6 5862.2 5785.2 5824.7 5834.6 5861.2 5897.1 5440.2 5448.0 5456.2 5467.9 5472.0 5725.8 5925.4 5931.1 5940.7 5950.3 5738.2 5742.5 5752.4 5760.9 5775.1 5869.2 5881.3 5882.9 5883.4 5898.2 5766.5 5813.4 5836.3 5861.6 5867.6 5778.9 5853.4 5854.6 5867.4 5877.3 4393.2 4453.4 4474.2 4512.3 4534.3 3922.9 3941.5 3980.2 4012.8 4014.8 5665.4 5692.4 5695.8 5719.5 5732.8 5757.9 5947.6 5950.2 5959.3 5992.0 5602.3 5619.4 5627.8 5642.6 5643.1 5001.2 5042.6 5081.4 5106.6 5109.7 5926.1 6057.4 6089.4 6149.3 6158.5 5899.1 5977.1 5980.4 5989.8 6000.2 6162.6 6189.3 6192.3 6194.5 6199.0 5695.5 5736.8 5806.2 5818.2 5828.5 5939.2 5960.2 5963.0 5966.1 6001.9 5798.5 5801.0 5808.1 5816.8 5823.8 5647.0 5661.7 5680.3 5696.0 5761.8 5637.8 5667.1 5667.5 5675.6 5678.1 5711.2 5734.3 5791.4 5796.8 5808.8 5594.9 5649.0 5665.8 5673.0 5693.6 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - PROCESS | 22539 | [#1] ext.html Cycles:180 Average:61611.21 Median:41925.87 stddev:127409.70 (303.9%) stddev-sans-first:127684.70 11:26:41 INFO - PROCESS | 22539 | Values: 571.7 613.4 626.3 634.4 661.2 40515.6 41830.4 45619.8 45822.5 45908.5 46111.0 46297.0 46463.3 46499.8 46652.3 8941.5 8983.3 9015.5 9035.1 9058.5 8899.1 8968.8 8971.8 9013.5 9013.8 9039.5 9056.2 9065.0 9083.2 9094.6 8990.7 9023.0 9039.5 9060.7 9076.7 8899.3 8925.8 8946.8 8953.8 8958.2 32598.7 43659.0 43828.1 44074.6 44169.3 3290.5 3328.8 3404.3 3491.8 3654.6 31012.4 31366.8 31480.0 31750.7 32797.0 4091.5 4114.2 4126.2 4217.7 4302.3 316260.0 318028.0 318056.0 318378.0 318505.0 35657.1 35701.8 35827.6 36068.5 36092.6 33919.8 34400.0 34543.3 36468.1 36965.6 17671.5 17794.8 18065.7 18082.2 18118.0 12681.1 12746.7 12781.9 12812.6 12836.0 20081.3 20194.3 20345.8 20407.5 20411.9 7442.5 7467.2 7482.5 7575.1 7587.8 925.7 1046.9 1052.0 1067.5 1108.3 33158.7 33564.5 33669.3 33820.3 34114.4 1082.1 1113.0 1161.4 1184.9 1197.0 17410.2 17703.2 17746.4 17812.4 17843.0 581433.0 595307.0 596324.0 596384.0 598158.0 59333.7 60277.7 60755.4 60766.7 60787.7 1328.3 1343.4 1354.8 1359.8 1361.3 30895.5 32947.0 32955.7 33065.8 33104.5 52813.7 53232.5 53269.2 53367.5 53491.0 478778.0 482590.0 484105.0 484218.0 486203.0 28809.6 28876.0 29072.7 29144.7 29291.4 49168.5 49545.0 49894.3 50787.2 51240.0 41455.8 42420.4 42423.0 43737.3 44171.3 42021.4 42756.6 43921.6 44000.3 44006.6 42481.4 43137.6 43665.8 43683.3 43851.8 36278.5 37755.0 38182.2 38503.6 39001.0 28829.1 28946.3 29062.9 29267.3 29377.9 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - PROCESS | 22539 | [#2] jquery.html Cycles:180 Average:27702.45 Median:20820.74 stddev:69391.16 (333.3%) stddev-sans-first:69555.51 11:26:41 INFO - PROCESS | 22539 | Values: 383.7 389.6 407.3 410.7 422.9 18897.3 20545.8 20789.7 20851.8 21014.0 18400.6 18452.9 19270.5 19789.0 19805.0 5730.8 5845.3 5948.9 5961.4 5971.2 5866.2 5920.7 5931.1 5932.6 5961.1 6277.0 6575.4 6585.4 6654.6 6701.1 6332.4 6437.0 6470.9 6496.3 6560.4 5650.0 5656.2 5664.9 5690.1 5696.6 13754.7 14347.0 23064.8 24249.5 24457.1 2287.4 2351.3 2369.4 2427.8 2889.3 10422.2 10536.0 10670.5 10881.6 10942.7 1815.5 1945.3 1959.0 1986.1 1997.2 80237.0 90418.0 91286.0 93290.0 93541.0 10857.6 10983.9 11023.9 11056.9 11074.9 14709.3 14799.6 14883.1 14890.1 14906.9 8088.7 8463.2 8516.9 8537.2 8553.4 8315.9 8316.0 8333.3 8388.7 8510.0 4508.3 4559.0 4618.0 4619.8 4773.2 1974.8 2017.2 2029.4 2031.6 2063.9 917.9 969.6 981.4 1007.1 1022.9 19855.0 20109.0 20141.3 20316.6 20340.7 1035.3 1038.8 1067.8 1082.3 1087.5 10680.4 11172.4 11191.8 11202.7 11212.7 359916.0 367128.0 369069.0 478094.0 478466.0 61646.7 106335.5 111160.4 114211.0 115219.0 1045.5 1057.6 1070.8 1101.6 1104.1 17835.7 18319.4 18340.7 18682.4 19001.9 44408.0 44983.8 44995.0 45058.0 46295.1 58271.8 58714.0 60391.7 61924.0 62109.0 7221.9 7911.7 9121.1 9242.1 9369.3 12428.4 13817.7 14106.4 14192.7 14244.1 12143.1 12407.9 12518.9 12522.5 12559.9 11806.5 12373.6 12393.7 12738.8 12926.7 12817.5 12956.2 12958.7 13048.5 13051.5 9176.7 9198.6 9262.4 9281.1 9500.3 12357.0 12863.2 12869.0 12875.0 12909.7 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - PROCESS | 22539 | [#3] mootools.html Cycles:180 Average:5866.27 Median:4658.99 stddev:3357.74 (72.1%) stddev-sans-first:3350.22 11:26:41 INFO - PROCESS | 22539 | Values: 1378.4 1463.6 1541.5 1750.3 1768.4 7653.0 8130.4 8398.4 9097.7 9103.3 8188.3 8483.3 8501.3 8542.9 8547.5 2299.8 2342.2 2347.5 2353.9 2360.0 2365.1 2371.7 2407.6 2411.3 2417.2 2380.8 2390.9 2401.4 2401.4 2406.9 2315.5 2316.4 2326.6 2330.9 2345.3 2305.9 2311.5 2319.6 2334.5 2344.0 8694.0 8704.7 8785.6 8787.7 8801.6 5088.3 5114.9 5125.7 5135.9 5347.3 3434.4 3484.1 3527.3 3534.7 3561.8 1058.4 1066.6 1076.8 1170.9 1173.4 12727.0 12737.8 12762.5 12847.6 12941.5 4531.6 4640.5 4677.5 4681.7 4944.9 10514.8 10523.0 10540.1 10540.3 10555.2 5512.4 5577.4 5598.4 5601.8 5608.9 4319.8 4788.4 4909.1 4931.2 5055.5 3983.2 4032.3 4051.4 4082.4 4113.8 1269.6 1322.1 1324.1 1327.1 1331.5 872.5 972.0 1016.7 1026.9 1032.3 5933.3 6033.6 6074.4 6144.6 6163.8 449.2 453.3 455.4 472.2 472.3 4226.9 4314.7 4342.9 4381.1 4435.0 10860.5 11337.5 11338.3 11347.7 11369.1 11294.0 11312.3 11320.3 11322.9 11347.8 7817.6 8111.9 8117.8 8142.5 8289.8 6006.5 6137.2 6258.2 6322.8 6478.3 9926.8 9933.0 10012.2 10059.7 10118.5 9893.2 10007.8 10208.0 10266.9 10299.6 7079.6 7513.5 7582.7 7585.0 7780.0 8579.4 8634.0 8656.2 8692.9 8790.0 7441.4 7776.2 7785.6 8015.3 8043.2 7669.1 7803.3 7846.1 7952.2 7970.0 7269.2 7315.4 7354.9 7374.5 7380.8 5130.4 5149.5 5151.8 5193.8 5226.2 5244.7 5315.0 5326.7 5329.1 5401.1 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - PROCESS | 22539 | [#4] prototype.html Cycles:180 Average:4904.60 Median:5514.38 stddev:1458.59 (26.5%) stddev-sans-first:1421.52 11:26:41 INFO - PROCESS | 22539 | Values: 320.2 326.2 327.3 327.7 334.2 5477.6 5499.9 5606.2 5627.9 5694.9 5528.8 5561.1 5568.2 5585.9 5586.8 4390.0 4410.3 4413.6 4417.1 4424.5 4109.4 4343.0 4349.7 4428.4 4431.8 4262.6 4268.5 4277.9 4302.4 4306.2 4292.8 4294.3 4304.0 4320.4 4344.9 3717.2 3734.7 3803.5 3803.9 3811.3 5420.2 5431.6 5434.2 5455.9 5471.2 4947.2 4994.1 5010.2 5010.2 5036.4 5615.8 5893.9 5911.5 5921.8 5932.6 4172.7 4184.7 4193.9 4196.4 4201.4 6048.9 6057.0 6080.6 6098.4 6105.7 4165.4 4250.7 4261.6 4266.3 4289.5 4284.5 4299.0 4326.7 4329.7 4334.7 4956.1 4956.2 4975.8 4989.6 4995.1 5707.6 5843.9 5900.8 5908.6 5953.4 1451.6 1475.8 1481.7 1485.9 1495.9 899.0 919.3 920.0 931.4 938.0 5092.7 5105.7 5136.3 5142.2 5156.9 5184.1 5335.4 5340.8 5361.0 5405.7 5050.9 5076.4 5076.7 5323.8 5801.4 3207.2 3219.2 3222.4 3231.3 3243.9 6123.8 6196.5 6211.5 6223.5 6259.2 6135.4 6175.8 6176.4 6177.4 6184.8 6244.9 6294.9 6308.2 6314.7 6344.5 5842.9 6043.6 6049.2 6050.4 6075.0 5984.1 5985.7 6009.5 6022.9 6025.3 5989.9 6289.2 6290.9 6299.0 6337.0 4265.7 4271.5 4285.3 4290.8 4296.1 6095.2 6103.2 6109.3 6117.0 6129.7 5674.5 5884.0 5913.5 5919.6 5929.8 5853.8 5896.6 5906.2 5921.9 5978.9 5707.5 5751.5 5826.8 5832.9 5861.6 5925.7 5928.9 5941.1 5952.3 5966.4 5806.9 5821.6 5821.8 5849.3 5855.6 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - PROCESS | 22539 | [#5] yui.html Cycles:180 Average:21093.30 Median:4264.68 stddev:31296.23 (733.8%) stddev-sans-first:31346.68 11:26:41 INFO - PROCESS | 22539 | Values: 730.1 734.9 742.2 744.4 779.7 14880.6 15889.4 15889.8 15963.6 17152.8 13428.3 13524.1 13547.5 13591.4 13652.7 655.5 774.1 788.2 789.3 793.1 796.7 804.7 805.5 807.8 808.8 857.4 857.9 860.9 861.7 863.9 848.7 853.5 853.6 855.2 858.2 623.4 625.4 625.9 627.5 629.6 15053.8 15071.3 15100.2 15123.7 15206.2 15871.3 15988.5 16029.7 16190.3 16265.4 11990.1 12040.8 12165.9 12194.5 12353.5 4000.6 4006.0 4019.1 4124.8 4137.7 84189.6 85041.3 86082.6 87011.6 87367.0 11360.3 11500.0 11508.5 11538.8 11574.8 21258.7 21293.0 21496.1 21552.6 21596.2 8056.7 8265.6 8320.1 8343.8 8373.2 4740.9 4746.9 4779.7 4795.5 4906.1 3455.9 3569.6 3586.0 3589.7 3602.3 565.5 586.5 587.6 598.1 614.7 553.8 636.8 646.7 669.3 688.2 8784.3 8827.0 8842.6 8931.5 9010.2 534.2 614.2 666.9 696.6 702.8 4100.0 4181.1 4215.1 4314.3 4340.4 118439.0 123895.4 124193.4 126348.0 128457.4 60173.7 78674.0 102528.5 102730.2 103490.0 75012.6 87601.1 88064.0 89236.6 95414.0 8168.3 8238.8 8296.5 8761.2 8825.9 53386.7 53721.0 53887.0 54679.2 56337.4 73562.0 80513.6 81125.0 81757.6 81857.0 10589.6 11095.2 11161.8 11196.9 11609.4 12563.7 12655.6 12686.2 12892.0 13200.9 11251.3 11281.6 11468.9 11842.2 11924.3 11568.8 11895.9 12140.8 12509.1 12588.6 11463.6 11781.8 13342.7 13413.0 13940.2 11388.5 11745.2 11935.6 11955.3 12056.5 10921.5 11459.5 11840.5 11874.9 12055.6 11:26:41 INFO - PROCESS | 22539 | -------- Summary: end -------- 11:26:41 INFO - PROCESS | 22539 | 11:26:41 INFO - TEST-INFO | 22539: exit 0 11:26:41 INFO - TEST-OK | dromaeo_css | took 1110818ms 11:26:41 INFO - TEST-START | kraken 11:26:41 INFO - operating with platform_type : linux_ 11:26:41 INFO - Initialising browser for kraken test... 11:26:41 INFO - TEST-INFO | started process 22780 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZcGxmB/profile http://localhost:41368/getInfo.html) 11:26:46 INFO - PROCESS | 22780 | __metrics Screen width/height:1600/1200 11:26:46 INFO - PROCESS | 22780 | colorDepth:24 11:26:46 INFO - PROCESS | 22780 | Browser inner width/height: 1024/697 11:26:46 INFO - PROCESS | 22780 | __metrics 11:26:46 ERROR - PROCESS | 22780 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 11:26:47 INFO - TEST-INFO | 22780: exit 0 11:26:47 INFO - Browser initialized. 11:26:47 INFO - Running cycle 1/1 for kraken test... 11:26:47 INFO - TEST-INFO | started process 22902 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZcGxmB/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:26:59 INFO - PROCESS | 22902 | RSS: Main: 168353792 11:26:59 INFO - PROCESS | 22902 | 11:27:01 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41368/tests/kraken/driver.html?testName=audio-beat-detection) 11:27:02 INFO - PROCESS | 22902 | RSS: Main: 173522944 11:27:02 INFO - PROCESS | 22902 | 11:27:05 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41368/tests/kraken/driver.html?testName=audio-dft) 11:27:05 INFO - PROCESS | 22902 | RSS: Main: 173125632 11:27:05 INFO - PROCESS | 22902 | 11:27:08 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41368/tests/kraken/driver.html?testName=audio-fft) 11:27:09 INFO - PROCESS | 22902 | RSS: Main: 167813120 11:27:09 INFO - PROCESS | 22902 | 11:27:11 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41368/tests/kraken/driver.html?testName=audio-oscillator) 11:27:12 INFO - PROCESS | 22902 | RSS: Main: 169508864 11:27:12 INFO - PROCESS | 22902 | 11:27:14 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41368/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:27:14 INFO - PROCESS | 22902 | RSS: Main: 168845312 11:27:14 INFO - PROCESS | 22902 | 11:27:17 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41368/tests/kraken/driver.html?testName=imaging-darkroom) 11:27:18 INFO - PROCESS | 22902 | RSS: Main: 168689664 11:27:18 INFO - PROCESS | 22902 | 11:27:21 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41368/tests/kraken/driver.html?testName=imaging-desaturate) 11:27:22 INFO - PROCESS | 22902 | RSS: Main: 170000384 11:27:22 INFO - PROCESS | 22902 | 11:27:25 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41368/tests/kraken/driver.html?testName=json-parse-financial) 11:27:26 INFO - PROCESS | 22902 | RSS: Main: 169803776 11:27:26 INFO - PROCESS | 22902 | 11:27:27 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41368/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:27:28 INFO - PROCESS | 22902 | RSS: Main: 170266624 11:27:28 INFO - PROCESS | 22902 | 11:27:30 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41368/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:27:30 INFO - PROCESS | 22902 | RSS: Main: 170020864 11:27:30 INFO - PROCESS | 22902 | 11:27:32 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41368/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:27:33 INFO - PROCESS | 22902 | RSS: Main: 170123264 11:27:33 INFO - PROCESS | 22902 | 11:27:35 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41368/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:27:36 INFO - PROCESS | 22902 | RSS: Main: 170876928 11:27:36 INFO - PROCESS | 22902 | 11:27:39 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41368/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:27:39 INFO - PROCESS | 22902 | RSS: Main: 170319872 11:27:39 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | Cycle 1(1): loaded http://localhost:41368/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41368/tests/kraken/driver.html?testName=ai-astar) 11:27:41 INFO - PROCESS | 22902 | RSS: Main: 170827776 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | __start_tp_report 11:27:41 INFO - PROCESS | 22902 | _x_x_mozilla_page_load 11:27:41 INFO - PROCESS | 22902 | _x_x_mozilla_page_load_details 11:27:41 INFO - PROCESS | 22902 | |i|pagename|runs| 11:27:41 INFO - PROCESS | 22902 | |0;ai-astar;103;111;108;111;114;113;113;110;111;111 11:27:41 INFO - PROCESS | 22902 | |1;audio-beat-detection;147;117;141;176;121;152;144;121;187;117 11:27:41 INFO - PROCESS | 22902 | |2;audio-dft;164;162;162;162;160;164;175;164;162;162 11:27:41 INFO - PROCESS | 22902 | |3;audio-fft;75;74;75;178;76;76;75;74;165;75 11:27:41 INFO - PROCESS | 22902 | |4;audio-oscillator;84;84;167;84;84;84;146;85;85;152 11:27:41 INFO - PROCESS | 22902 | |5;imaging-gaussian-blur;117;118;117;117;117;119;118;116;117;117 11:27:41 INFO - PROCESS | 22902 | |6;imaging-darkroom;147;147;146;147;147;147;147;148;147;146 11:27:41 INFO - PROCESS | 22902 | |7;imaging-desaturate;95;95;96;95;95;96;96;96;96;95 11:27:41 INFO - PROCESS | 22902 | |8;json-parse-financial;57;56;55;57;62;55;54;55;56;55 11:27:41 INFO - PROCESS | 22902 | |9;json-stringify-tinderbox;62;62;62;63;63;63;63;63;64;63 11:27:41 INFO - PROCESS | 22902 | |10;stanford-crypto-aes;77;79;75;74;83;74;77;75;78;74 11:27:41 INFO - PROCESS | 22902 | |11;stanford-crypto-ccm;134;118;133;118;123;120;121;127;160;126 11:27:41 INFO - PROCESS | 22902 | |12;stanford-crypto-pbkdf2;160;159;155;158;156;161;157;153;156;155 11:27:41 INFO - PROCESS | 22902 | |13;stanford-crypto-sha256-iterative;62;67;67;63;65;67;62;65;63;62 11:27:41 INFO - PROCESS | 22902 | __end_tp_report 11:27:41 INFO - PROCESS | 22902 | __start_cc_report 11:27:41 INFO - PROCESS | 22902 | _x_x_mozilla_cycle_collect,909 11:27:41 INFO - PROCESS | 22902 | __end_cc_report 11:27:41 INFO - PROCESS | 22902 | __startTimestamp1467656861786__endTimestamp 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | ------- Summary: start ------- 11:27:41 INFO - PROCESS | 22902 | Number of tests: 14 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#0] ai-astar Cycles:10 Average:110.50 Median:111.00 stddev:3.14 (2.8%) stddev-sans-first:1.80 11:27:41 INFO - PROCESS | 22902 | Values: 103.0 111.0 108.0 111.0 114.0 113.0 113.0 110.0 111.0 111.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#1] audio-beat-detection Cycles:10 Average:142.30 Median:145.50 stddev:24.59 (16.9%) stddev-sans-first:26.02 11:27:41 INFO - PROCESS | 22902 | Values: 147.0 117.0 141.0 176.0 121.0 152.0 144.0 121.0 187.0 117.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#2] audio-dft Cycles:10 Average:163.70 Median:163.00 stddev:4.16 (2.6%) stddev-sans-first:4.42 11:27:41 INFO - PROCESS | 22902 | Values: 164.0 162.0 162.0 162.0 160.0 164.0 175.0 164.0 162.0 162.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#3] audio-fft Cycles:10 Average:94.30 Median:75.00 stddev:40.81 (54.4%) stddev-sans-first:42.68 11:27:41 INFO - PROCESS | 22902 | Values: 75.0 74.0 75.0 178.0 76.0 76.0 75.0 74.0 165.0 75.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#4] audio-oscillator Cycles:10 Average:105.50 Median:84.00 stddev:34.54 (41.1%) stddev-sans-first:35.75 11:27:41 INFO - PROCESS | 22902 | Values: 84.0 84.0 167.0 84.0 84.0 84.0 146.0 85.0 85.0 152.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#5] imaging-gaussian-blur Cycles:10 Average:117.30 Median:117.00 stddev:0.82 (0.7%) stddev-sans-first:0.87 11:27:41 INFO - PROCESS | 22902 | Values: 117.0 118.0 117.0 117.0 117.0 119.0 118.0 116.0 117.0 117.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#6] imaging-darkroom Cycles:10 Average:146.90 Median:147.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 11:27:41 INFO - PROCESS | 22902 | Values: 147.0 147.0 146.0 147.0 147.0 147.0 147.0 148.0 147.0 146.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:96.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 11:27:41 INFO - PROCESS | 22902 | Values: 95.0 95.0 96.0 95.0 95.0 96.0 96.0 96.0 96.0 95.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#8] json-parse-financial Cycles:10 Average:56.20 Median:56.00 stddev:2.25 (4.0%) stddev-sans-first:2.37 11:27:41 INFO - PROCESS | 22902 | Values: 57.0 56.0 55.0 57.0 62.0 55.0 54.0 55.0 56.0 55.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#9] json-stringify-tinderbox Cycles:10 Average:62.80 Median:63.00 stddev:0.63 (1.0%) stddev-sans-first:0.60 11:27:41 INFO - PROCESS | 22902 | Values: 62.0 62.0 62.0 63.0 63.0 63.0 63.0 63.0 64.0 63.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#10] stanford-crypto-aes Cycles:10 Average:76.60 Median:77.00 stddev:2.88 (3.7%) stddev-sans-first:3.05 11:27:41 INFO - PROCESS | 22902 | Values: 77.0 79.0 75.0 74.0 83.0 74.0 77.0 75.0 78.0 74.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#11] stanford-crypto-ccm Cycles:10 Average:128.00 Median:126.50 stddev:12.60 (10.0%) stddev-sans-first:13.17 11:27:41 INFO - PROCESS | 22902 | Values: 134.0 118.0 133.0 118.0 123.0 120.0 121.0 127.0 160.0 126.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:157.00 Median:157.50 stddev:2.49 (1.6%) stddev-sans-first:2.40 11:27:41 INFO - PROCESS | 22902 | Values: 160.0 159.0 155.0 158.0 156.0 161.0 157.0 153.0 156.0 155.0 11:27:41 INFO - PROCESS | 22902 | 11:27:41 INFO - PROCESS | 22902 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.30 Median:65.00 stddev:2.16 (3.3%) stddev-sans-first:2.13 11:27:41 INFO - PROCESS | 22902 | Values: 62.0 67.0 67.0 63.0 65.0 67.0 62.0 65.0 63.0 62.0 11:27:41 INFO - PROCESS | 22902 | -------- Summary: end -------- 11:27:41 INFO - PROCESS | 22902 | 11:27:42 INFO - TEST-INFO | 22902: exit 0 11:27:42 INFO - TEST-OK | kraken | took 60959ms 11:27:42 INFO - SUITE-END | took 1171s 11:27:42 INFO - Completed test suite (00:19:31) 11:27:42 INFO - javascript benchmark 11:27:43 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7334.01690857824, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3123.9375212495747, 3143.5127555228946, 3165.1928758166664, 3183.331500384919, 3191.425543402188, 5410.51305382516, 5417.133258678612, 5468.863278418036, 5543.085390910495, 5551.8889622207535, 5274.92087618686, 5382.407935127133, 5395.59533035022, 5451.236826844245, 5560.443955604448, 4860.319555262275, 4889.535494128052, 4989.525995030466, 5056.544910958013, 5100.132977393852, 800.6450861616278, 4899.387576552931, 4908.0429316283335, 4917.532834380746, 5063.645544811865, 4919.508049195069, 4948.950510494885, 4958.380202474691, 4962.776675049613, 4971.0, 4984.277279794445, 4984.900301993976, 4993.051320249141, 4996.150654388763, 5006.674566153189, 4868.95131048692, 4887.584555312767, 4927.433345165316, 4956.107900577895, 4972.8756781080765, 5372.167314066326, 5454.372747134091, 5457.754401051962, 5459.12653975362, 5518.2826232589905, 5572.665640061609, 5697.4302569742695, 5805.042168042268, 5859.560532960045, 5862.237909071836, 5785.1611516329895, 5824.650520968756, 5834.562407819388, 5861.2087368205175, 5897.0859516774535, 5440.156775699773, 5448.0, 5456.236126942231, 5467.9453205467835, 5472.015037293286, 5725.799597014085, 5925.4370834770625, 5931.051031834886, 5940.70296485174, 5950.285965684146, 5738.196652468658, 5742.54059675225, 5752.36723960364, 5760.913586296209, 5775.104858746901, 5869.236999190078, 5881.2942446906645, 5882.911756323659, 5883.411658834082, 5898.174255604219, 5766.452187042224, 5813.447722466359, 5836.270466191726, 5861.6189947653265, 5867.618604790675, 5778.913316300259, 5853.356130825606, 5854.619449735838, 5867.354590994987, 5877.324107727666, 4393.165298593257, 4453.376527286183, 4474.194644963873, 4512.300593408027, 4534.274516077412, 3922.941155882664, 3941.546722126992, 3980.20395920817, 4012.7792971386853, 4014.759114453142, 5665.405132461115, 5692.373838877803, 5695.775408287155, 5719.542436605062, 5732.799352022659, 5757.88484230313, 5947.613405128739, 5950.166976623276, 5959.255093113361, 5992.0, 5602.2717046783655, 5619.381867994517, 5627.831165065055, 5642.576806739429, 5643.097104463266, 5001.199808030698, 5042.596592272609, 5081.415637201695, 5106.617003724736, 5109.744512774347, 5926.111083337448, 6057.42454466825, 6089.360617135226, 6149.292831324366, 6158.538109641705, 5899.144624029492, 5977.073553599199, 5980.37206093354, 5989.790357337472, 6000.189974353581, 6162.630242185483, 6189.288231853395, 6192.349803270772, 6194.5044396449075, 6198.969005154945, 5695.487406133302, 5736.770529178953, 5806.2451881255165, 5818.2436283282905, 5828.533717302521, 5939.227900372924, 5960.195373624505, 5963.0, 5966.134910438049, 6001.939980600138, 5798.478136967525, 5801.0, 5808.128780682931, 5816.796412125555, 5823.82528524145, 5646.971765141148, 5661.745221465127, 5680.346760122638, 5695.971520142539, 5761.769529218785, 5637.774489020393, 5667.093265077568, 5667.518260947865, 5675.602707810413, 5678.14827775837, 5711.228984087095, 5734.254546908875, 5791.391903850204, 5796.768129274782, 5808.796692115756, 5594.916076258941, 5648.971755141198, 5665.830025099089, 5672.971635141798, 5693.572982026281], "value": 5377.776899407332, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [571.745573219917, 613.426446272735, 626.2922897126244, 634.3529599808194, 661.1867403094191, 40515.59484405155, 41830.37254441186, 45619.77190114053, 45822.541774582205, 45908.54091459084, 46111.0, 46297.0, 46463.30305045418, 46499.767501162445, 46652.3002154968, 8941.50821704806, 8983.281337493017, 9015.504147271897, 9035.051319611444, 9058.456492610465, 8899.110088991114, 8968.820623587524, 8971.820563588724, 9013.54932253388, 9013.819723605524, 9039.457632542035, 9056.230220431271, 9065.0, 9083.227925626297, 9094.63621455141, 8990.730278091667, 9023.007469178385, 9039.457632542035, 9060.728178154666, 9076.727698169065, 8899.332550058707, 8925.776855578597, 8946.776330591721, 8953.776155596097, 8958.193762561335, 32598.674013259802, 43659.0, 43828.123437531074, 44074.559254407366, 44169.33745993813, 3290.457074582691, 3328.8169150696704, 3404.302118065815, 3491.773034752758, 3654.5797233317976, 31012.37975240505, 31366.843165784026, 31480.0, 31750.682493175005, 32797.0, 4091.509018917719, 4114.238865809834, 4126.223208272258, 4217.725847819882, 4302.290122129845, 316259.9999999977, 318028.0, 318056.0, 318378.0, 318505.0, 35657.10857228538, 35701.8214908929, 35827.641723582434, 36068.45897311543, 36092.639073609454, 33919.83040084833, 34400.0, 34543.30913381718, 36468.08829779277, 36965.63034369622, 17671.469855904088, 17794.822051779574, 18065.7290140648, 18082.186301616457, 18118.0, 12681.112322137362, 12746.745065098647, 12781.872181278255, 12812.61562153137, 12836.037297202747, 20081.29715459952, 20194.29319973794, 20345.796542034685, 20407.4898127548, 20411.8979405105, 7442.479026468095, 7467.178610352857, 7482.47622666419, 7575.128860181039, 7587.772366829004, 925.6575067225169, 1046.884842667306, 1051.9684409467727, 1067.503610820972, 1108.2740804772886, 33158.66841331556, 33564.49653255203, 33669.326613467594, 33820.32359352799, 34114.4179861116, 1082.1396989393452, 1112.9944350278197, 1161.4367031989477, 1184.9289042657467, 1197.024425093546, 17410.21654025572, 17703.20335584876, 17746.37887673925, 17812.37656682036, 17843.0, 581433.0, 595307.0, 596324.0, 596384.0, 598158.0, 59333.70333148393, 60277.69861150754, 60755.39244607586, 60766.69616651977, 60787.69606152029, 1328.2893651896381, 1343.4424713743688, 1354.830646169209, 1359.8436179839248, 1361.3057340756088, 30895.536566951963, 32947.0, 32955.67044329526, 33065.834670826494, 33104.50343244901, 52813.73593132164, 53232.467675324304, 53269.200961986375, 53367.46632533625, 53491.0, 478778.0, 482590.0, 484105.0, 484218.0, 486203.0, 28809.56785648175, 28876.0, 29072.709272907847, 29144.7085529142, 29291.41417171602, 49168.50831491639, 49545.0, 49894.251586226965, 50787.23819142642, 51240.0, 41455.7927210362, 42420.36369454522, 42423.0, 43737.343939841565, 44171.337429937936, 42021.36967945544, 42756.57243427526, 43921.56078439303, 44000.33999489946, 44006.55993440025, 42481.36277955771, 43137.56862431335, 43665.78167109144, 43683.344749828146, 43851.78074109609, 36278.45582316215, 37755.0, 38182.23635527329, 38503.61496385113, 39001.0, 28829.135125946254, 28946.27634309159, 29062.854685726437, 29267.268318292212, 29377.853110734308], "value": 20045.89388854752, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [383.6719604737951, 389.5578518381636, 407.31977597412316, 410.67556630262084, 422.9492460904692, 18897.338593149227, 20545.794542054577, 20789.68815467767, 20851.791482085155, 21014.0, 18400.631987360244, 18452.907735461304, 19270.51823704408, 19789.0, 19805.0, 5730.828075157752, 5845.269341332344, 5948.910766338508, 5961.403859614047, 5971.164037034819, 5866.208061911651, 5920.674362910038, 5931.051031834907, 5932.644041357511, 5961.1058341248945, 6277.0, 6575.375339342779, 6585.37438943302, 6654.600723956554, 6701.128853249071, 6332.398422149911, 6436.967815160941, 6470.935290647104, 6496.317886621931, 6560.376764207393, 5649.983003059448, 5656.208130861683, 5664.915026274609, 5690.061139911951, 5696.63280812602, 13754.724905501935, 14347.0, 23064.846757662217, 24249.515009699706, 24457.143999959917, 2287.359539328974, 2351.294611616508, 2369.383960170368, 2427.7936375408112, 2889.2921234297523, 10422.21833362501, 10536.0, 10670.51982660782, 10881.564737410574, 10942.671719848417, 1815.5007372972539, 1945.2510783348512, 1958.9706154407695, 1986.1261045140236, 1997.2310660395708, 80237.0, 90418.0, 91286.0, 93290.0, 93541.0, 10857.619983300547, 10983.890161098447, 11023.944880275547, 11056.889431105586, 11074.866971909418, 14709.338079786436, 14799.63000924964, 14883.107013579003, 14890.106593604418, 14906.850931490546, 8088.71689490865, 8463.15368463161, 8516.8722469163, 8537.18896704812, 8553.44402613828, 8315.916840831514, 8316.0, 8333.33333333332, 8388.748337549883, 8510.0, 4508.256137737302, 4558.954410455919, 4618.030213655103, 4619.815207391734, 4773.164696178155, 1974.8420126389854, 2017.2233690029445, 2029.4216148397636, 2031.6343058249656, 2063.886486243241, 917.9082091790901, 969.5636963366513, 981.4356744871727, 1007.1388962437011, 1022.8874823769379, 19855.0, 20109.0, 20141.295054673017, 20316.593668126556, 20340.69488957667, 1035.3322107240788, 1038.8493668418037, 1067.8291473364225, 1082.2910993299402, 1087.456271864068, 10680.412577308323, 11172.44137793107, 11191.832122518006, 11202.719932001764, 11212.66362009141, 359916.0, 367128.0, 369069.0, 478094.0, 478466.0, 61646.691766540884, 106335.46832265789, 111160.44419777849, 114211.0, 115219.0, 1045.5295117197293, 1057.629829559648, 1070.7911957168278, 1101.5593762495066, 1104.0615476844778, 17835.73246401331, 18319.35882244115, 18340.72488912694, 18682.439526814218, 19001.904990475512, 44408.0, 44983.77508112438, 44995.0, 45058.0, 46295.07409851851, 58271.83456330934, 58714.0, 60391.69804150951, 61924.0, 62109.0, 7221.855562888818, 7911.734122540366, 9121.087891211091, 9242.12199841014, 9369.344145909721, 12428.378581070729, 13817.723645527234, 14106.36521356562, 14192.716145677236, 14244.07413518118, 12143.089268304735, 12407.93796031014, 12518.93740531328, 12522.499100035897, 12559.87440125587, 11806.527738890349, 12373.62879113628, 12393.690157745768, 12738.808917866054, 12926.676833079247, 12817.487300508248, 12956.157849739737, 12958.740825183631, 13048.54330098442, 13051.477940882258, 9176.724698259062, 9198.632054717737, 9262.351635385457, 9281.118293762082, 9500.334976551576, 12357.0, 12863.22820630765, 12869.0, 12875.0, 12909.677258068623], "value": 9553.054725251808, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1378.393506856983, 1463.6121427821627, 1541.452784261587, 1750.3086280919028, 1768.3899054826097, 7653.0, 8130.390220733454, 8398.370122240833, 9097.727068187949, 9103.317251206161, 8188.2630563249295, 8483.321334293258, 8501.319894408449, 8542.91457085429, 8547.529885856275, 2299.7585253548386, 2342.1802369170823, 2347.5187586544716, 2353.870537120458, 2360.0205914545445, 2365.136725095345, 2371.703537057868, 2407.5786737320987, 2411.336882357357, 2417.2023232333377, 2380.8333416660753, 2390.8924098415528, 2401.399650087478, 2401.4236583220077, 2406.9398265043337, 2315.4790172211287, 2316.420894776306, 2326.639370897514, 2330.906763729449, 2345.2846881701075, 2305.9308220753237, 2311.4683622766856, 2319.6404557293477, 2334.5447637710654, 2344.0155134843235, 8694.0, 8704.695335663222, 8785.604647790864, 8787.736367908972, 8801.647934082694, 5088.338515992934, 5114.872128196787, 5125.743712814382, 5135.922961155586, 5347.278117454132, 3434.3989801784587, 3484.1289677580603, 3527.2592755521373, 3534.734894882894, 3561.821908904544, 1058.4496062047692, 1066.6000249906285, 1076.7631121153333, 1170.8536432945882, 1173.3722458484756, 12726.981841452662, 12737.808932865923, 12762.489500419972, 12847.614571562868, 12941.547045853444, 4531.614812740954, 4640.489546149921, 4677.4854765975715, 4681.742504162304, 4944.8763780905765, 10514.842277365846, 10523.0, 10540.104091152185, 10540.262181647364, 10555.208359373079, 5512.448755124456, 5577.442255774471, 5598.384177740445, 5601.803936862272, 5608.859778505488, 4319.762413067311, 4788.449328327218, 4909.091818013679, 4931.161702510582, 5055.545000949932, 3983.203359328146, 4032.2540330039037, 4051.3922911562913, 4082.3672330788777, 4113.794310284474, 1269.6254604891578, 1322.0745478165322, 1324.0996122636507, 1327.1373607155426, 1331.467413034794, 872.5070335260557, 972.0376826941418, 1016.7305663999047, 1026.9383836969657, 1032.2774058159318, 5933.3473317934995, 6033.642430453113, 6074.362191969868, 6144.56988010835, 6163.7842675506145, 449.19593926871187, 453.31323045585304, 455.398873486994, 472.23733670122505, 472.27270004193156, 4226.85206017794, 4314.71954322968, 4342.913141737147, 4381.123775244963, 4435.046465010038, 10860.456977151269, 11337.489812958436, 11338.319700817978, 11347.716307092223, 11369.09047276216, 11294.0, 11312.321260724382, 11320.26418282809, 11322.94338528302, 11347.829782553268, 7817.57003364809, 8111.918880811234, 8117.837643247102, 8142.51144931306, 8289.792755181168, 6006.549508786946, 6137.202163718688, 6258.217722784652, 6322.841928951813, 6478.28738838718, 9926.801463970536, 9933.0, 10012.249081319076, 10059.69820905374, 10118.544665489924, 9893.208543316374, 10007.849882251918, 10208.0, 10266.948665256627, 10299.609552710288, 7079.646017699198, 7513.4740568159705, 7582.696692132253, 7585.0, 7779.961100194463, 8579.442336248125, 8633.95683021606, 8656.22094011542, 8692.91307086921, 8789.956050219707, 7441.4418918582405, 7776.222377762178, 7785.610719464117, 8015.318697910743, 8043.235892590194, 7669.079710434784, 7803.258690424401, 7846.136924938366, 7952.204779522233, 7970.043594768433, 7269.164046134762, 7315.3781928534545, 7354.852902941804, 7374.520656157332, 7380.77857664271, 5130.435652078194, 5149.536541711264, 5151.793928242828, 5193.844184674465, 5226.163813789775, 5244.685318880879, 5315.043292207285, 5326.6537675050995, 5329.09405401075, 5401.054815407209], "value": 4616.754501055923, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [320.24741856636894, 326.24311597094743, 327.3436759297609, 327.6690542552023, 334.18792334626875, 5477.616566840323, 5499.917501237484, 5606.187102870082, 5627.887442251158, 5694.857628559283, 5528.834134975947, 5561.110222364423, 5568.1647752837, 5585.916211256825, 5586.804461843836, 4389.978050109761, 4410.338449232609, 4413.587651951377, 4417.11657668466, 4424.535423780505, 4109.445224894645, 4342.97828510857, 4349.673774466912, 4428.446444194476, 4431.756253406062, 4262.593344196408, 4268.466441694788, 4277.935830962538, 4302.397664326981, 4306.181825453154, 4292.785360731982, 4294.312909934411, 4304.031592891605, 4320.395144679747, 4344.934825977582, 3717.1822199116423, 3734.739040704169, 3803.4675145479655, 3803.9429408558894, 3811.313963486571, 5420.208592574827, 5431.565474762049, 5434.157705555645, 5455.945440545584, 5471.23402723619, 4947.183714687072, 4994.126027945132, 5010.248462730583, 5010.248462730619, 5036.445990940993, 5615.848751006075, 5893.852653683693, 5911.467967882912, 5921.792737254218, 5932.644041357489, 4172.749635021908, 4184.7070705050655, 4193.916121677549, 4196.412502249687, 4201.411802347674, 6048.854595610302, 6056.9697151513965, 6080.604760690541, 6098.420650038239, 6105.725242364104, 4165.354370072643, 4250.681198910032, 4261.595148460891, 4266.31738921771, 4289.506706728766, 4284.493571260785, 4298.968247620611, 4326.718763280377, 4329.718568293051, 4334.699590123014, 4956.132676781549, 4956.231784073474, 4975.800967961313, 4989.55094041538, 4995.125852975715, 5707.571932105108, 5843.853903652443, 5900.757712069386, 5908.586398952032, 5953.374895635982, 1451.5935538049364, 1475.76387777955, 1481.7257158843602, 1485.8737007354496, 1495.9102453852586, 898.9775255618531, 919.3105171121658, 920.0, 931.4411353188033, 938.0, 5092.745362731848, 5105.744712764347, 5136.2552429898205, 5142.151544995034, 5156.92264616031, 5184.092783762826, 5335.413104558495, 5340.786368545215, 5361.0, 5405.675659460445, 5050.924236136461, 5076.44159142494, 5076.7207803571155, 5323.813666521653, 5801.419858014165, 3207.2142325130494, 3219.211293233173, 3222.4038552867796, 3231.337575796956, 3243.935121297608, 6123.8162855114415, 6196.504279657616, 6211.478187844007, 6223.533235007392, 6259.248890133122, 6135.380125725843, 6175.814725558241, 6176.413240742122, 6177.413145751147, 6184.804394439999, 6244.906326405107, 6294.937050629526, 6308.179936608211, 6314.747410103636, 6344.49244060474, 5842.941570584239, 6043.637381757108, 6049.153118563493, 6050.364711705208, 6074.967255566476, 5984.1323008164445, 5985.670788106696, 6009.549283803644, 6022.8795424090395, 6025.307089684742, 5989.940100598938, 6289.245290565162, 6290.937090629035, 6299.0, 6337.0, 4265.722728022669, 4271.466066741657, 4285.250081235834, 4290.849820256401, 4296.076343586144, 6095.238095238095, 6103.206583144163, 6109.266887973472, 6117.0, 6129.724162412613, 5674.460926212003, 5883.970580147072, 5913.497352725067, 5919.6152250103605, 5929.822105336847, 5853.765849365977, 5896.616719913192, 5906.232189815469, 5921.881562368814, 5978.880422391615, 5707.516045828032, 5751.4536119068625, 5826.82519524415, 5832.883342333044, 5861.6189947653265, 5925.652006616248, 5928.851778705567, 5941.1088336749835, 5952.315483719254, 5966.435676707236, 5806.912896306474, 5821.563382746395, 5821.79623713168, 5849.268841394825, 5855.619384739978], "value": 4428.47048520218, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [730.0728075344313, 734.8860926556384, 742.1650643026595, 744.430510659346, 779.6686408276482, 14880.553583392488, 15889.364425422984, 15889.761653575177, 15963.600909977256, 17152.82847171528, 13428.261445620486, 13524.120932139404, 13547.525836595722, 13591.38838752256, 13652.658683532916, 655.4657953767664, 774.0981756253957, 788.1724189600897, 789.2975252025702, 793.111714879336, 796.6972550430828, 804.7143264141233, 805.5207151744703, 807.7617102954613, 808.7856717969743, 857.3955361470148, 857.901341345747, 860.8751730999002, 861.7285555050171, 863.8704194370863, 848.6817443458702, 853.5177624642057, 853.607340623314, 855.2003876375578, 858.1761508951414, 623.3890787028691, 625.4277336237337, 625.8654389306275, 627.4603840696997, 629.5750368501243, 15053.849461505355, 15071.321790519452, 15100.244987750679, 15123.697526049418, 15206.16366099864, 15871.28579213938, 15988.52034438957, 16029.679406411922, 16190.271437785328, 16265.430709925096, 11990.14318220213, 12040.81938770919, 12165.939170304091, 12194.451249693786, 12353.505859765599, 4000.6399424051974, 4005.959940400588, 4019.075612609087, 4124.793760312003, 4137.668986481074, 84189.57905210435, 85041.32272724998, 86082.56958715167, 87011.56494217488, 87366.99999999936, 11360.318380897173, 11499.999999999833, 11508.53965841357, 11538.76922461563, 11574.768504629861, 21258.681119783214, 21293.0, 21496.14015439396, 21552.56894862094, 21596.244131455325, 8056.7180148694515, 8265.586720663943, 8320.126386729427, 8343.8331233375, 8373.204545568162, 4740.905181896412, 4746.928796068062, 4779.713217206979, 4795.520447955177, 4906.092372911023, 3455.87904423344, 3569.5716514018486, 3585.982070089633, 3589.730770192246, 3602.2615363850346, 565.4712843491349, 586.4985437451003, 587.5916238214486, 598.099859711132, 614.6865098799644, 553.7535796570568, 636.8216899268213, 646.7348387161242, 669.3473862983552, 688.198249039873, 8784.341174411944, 8826.955865220762, 8842.602082906285, 8931.508767017747, 9010.234130099016, 534.156033467121, 614.2444792904663, 666.8732940741244, 696.6273043921477, 702.8453740177152, 4100.0, 4181.1010632714115, 4215.093754842662, 4314.266574682311, 4340.414044104005, 118439.0, 123895.38052309681, 124193.37903310606, 126348.0, 128457.35771321083, 60173.699131504065, 78674.0, 102528.48735756423, 102730.2406271403, 103490.0, 75012.62493687497, 87601.12398876058, 88064.0, 89236.55381723179, 95414.0, 8168.264856162737, 8238.752837414888, 8296.460730052528, 8761.167689069529, 8825.91174088251, 53386.733066335975, 53721.0, 53887.0, 54679.17981230364, 56337.35372459906, 73562.0, 80513.59743201481, 81125.0, 81757.59121204355, 81857.0, 10589.576416943237, 11095.16786241019, 11161.776764464828, 11196.94401527987, 11609.419529023346, 12563.685907852378, 12655.557055503014, 12686.238825670489, 12892.0, 13200.884098641338, 11251.268667536584, 11281.605143819927, 11468.94265528667, 11842.230255033395, 11924.344161071225, 11568.826467603161, 11895.940520297343, 12140.75718485643, 12509.124361294622, 12588.559400420942, 11463.598774042868, 11781.823272651089, 13342.666433339244, 13413.0, 13940.163590184622, 11388.487518061873, 11745.236559623598, 11935.582254621047, 11955.282683038698, 12056.457459414172, 10921.508532115915, 11459.484323205643, 11840.526378944745, 11874.881251187378, 12055.638330850088], "value": 7390.0427825581955, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1520.8999999999996, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 111.0, 108.0, 111.0, 114.0, 113.0, 113.0, 110.0, 111.0, 111.0], "value": 110.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 117.0, 141.0, 176.0, 121.0, 152.0, 144.0, 121.0, 187.0, 117.0], "value": 142.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 162.0, 162.0, 162.0, 160.0, 164.0, 175.0, 164.0, 162.0, 162.0], "value": 163.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 75.0, 178.0, 76.0, 76.0, 75.0, 74.0, 165.0, 75.0], "value": 94.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 167.0, 84.0, 84.0, 84.0, 146.0, 85.0, 85.0, 152.0], "value": 105.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 117.0, 117.0, 117.0, 119.0, 118.0, 116.0, 117.0, 117.0], "value": 117.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 146.0, 147.0, 147.0, 147.0, 147.0, 148.0, 147.0, 146.0], "value": 146.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 96.0, 95.0, 95.0, 96.0, 96.0, 96.0, 96.0, 95.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 56.0, 55.0, 57.0, 62.0, 55.0, 54.0, 55.0, 56.0, 55.0], "value": 56.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 62.0, 62.0, 63.0, 63.0, 63.0, 63.0, 63.0, 64.0, 63.0], "value": 62.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 79.0, 75.0, 74.0, 83.0, 74.0, 77.0, 75.0, 78.0, 74.0], "value": 76.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [134.0, 118.0, 133.0, 118.0, 123.0, 120.0, 121.0, 127.0, 160.0, 126.0], "value": 128.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 159.0, 155.0, 158.0, 156.0, 161.0, 157.0, 153.0, 156.0, 155.0], "value": 157.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 67.0, 67.0, 63.0, 65.0, 67.0, 62.0, 65.0, 63.0, 62.0], "value": 64.3, "unit": "score"}]}]} 11:27:43 INFO - Return code: 0 11:27:43 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:27:43 ERROR - # TBPL SUCCESS # 11:27:43 INFO - Running post-action listener: _resource_record_post_action 11:27:43 INFO - ##### 11:27:43 INFO - ##### Finished run-tests step (success) 11:27:43 INFO - ##### 11:27:43 INFO - Running post-run listener: _resource_record_post_run 11:27:43 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 4096; Write bytes: 570757120; Read time: 16; Write time: 511528 11:27:43 INFO - TinderboxPrint: CPU usage
13.3% 11:27:43 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 11:27:43 INFO - TinderboxPrint: I/O write bytes / time
570,757,120 / 511,528 11:27:43 INFO - TinderboxPrint: CPU idle
8,223.3 (86.7%) 11:27:43 INFO - TinderboxPrint: CPU user
1,209.0 (12.7%) 11:27:43 INFO - TinderboxPrint: Swap in / out
0 / 0 11:27:43 INFO - install - Wall time: 18s; CPU: 14.0%; Read bytes: 0; Write bytes: 268857344; Read time: 0; Write time: 291192 11:27:43 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 0; Write bytes: 297316352; Read time: 0; Write time: 219572 11:27:43 INFO - Running post-run listener: _upload_blobber_files 11:27:43 INFO - Blob upload gear active. 11:27:43 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:27:43 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 11:27:43 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', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:27:43 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 -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:27:44 INFO - (blobuploader) - INFO - Open directory for files ... 11:27:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 11:27:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:27:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:27:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 11:27:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:27:45 INFO - (blobuploader) - INFO - Done attempting. 11:27:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 11:27:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:27:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:27:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 11:27:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:27:45 INFO - (blobuploader) - INFO - Done attempting. 11:27:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:27:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:27:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:27:49 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:27:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:27:49 INFO - (blobuploader) - INFO - Done attempting. 11:27:49 INFO - (blobuploader) - INFO - Iteration through files over. 11:27:49 INFO - Return code: 0 11:27:49 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:27:49 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:27:49 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/4c46ae08e7b863ade59345b8a40ba71ced77f0647b04e31546992e7a97e3192942960ea716acd755b0611cbc247e3f8597010e4b53f1daccff2a776529ead677", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1c5aac74e4cbbb590efbd63c005c149a6bfec4c2dcf8fbaba6c4b3e92d31218dd294f80ac5a47958983bdeaa3aa7d607ec58b6a4be15d559235ebd83fdb85f6a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a0f6cfccbfd1f06ec1b438c3469c12e088d1f254193049ccfbc911e5608c2b103df7f542058ae47ddd0a0d88cc7c23f2842a6616ce8ac884c2fb7a533efdda13"} 11:27:49 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:27:49 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:27:49 INFO - Contents: 11:27:49 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/4c46ae08e7b863ade59345b8a40ba71ced77f0647b04e31546992e7a97e3192942960ea716acd755b0611cbc247e3f8597010e4b53f1daccff2a776529ead677", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1c5aac74e4cbbb590efbd63c005c149a6bfec4c2dcf8fbaba6c4b3e92d31218dd294f80ac5a47958983bdeaa3aa7d607ec58b6a4be15d559235ebd83fdb85f6a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a0f6cfccbfd1f06ec1b438c3469c12e088d1f254193049ccfbc911e5608c2b103df7f542058ae47ddd0a0d88cc7c23f2842a6616ce8ac884c2fb7a533efdda13"} 11:27:49 INFO - Running post-run listener: copy_logs_to_upload_dir 11:27:49 INFO - Copying logs to upload dir... 11:27:49 INFO - mkdir: /builds/slave/test/build/upload/logs 11:27:49 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1229.097284 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 29 secs) (at 2016-07-04 11:27:49.085332) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-04 11:27:49.088674) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840 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/sha512/4c46ae08e7b863ade59345b8a40ba71ced77f0647b04e31546992e7a97e3192942960ea716acd755b0611cbc247e3f8597010e4b53f1daccff2a776529ead677", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1c5aac74e4cbbb590efbd63c005c149a6bfec4c2dcf8fbaba6c4b3e92d31218dd294f80ac5a47958983bdeaa3aa7d607ec58b6a4be15d559235ebd83fdb85f6a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a0f6cfccbfd1f06ec1b438c3469c12e088d1f254193049ccfbc911e5608c2b103df7f542058ae47ddd0a0d88cc7c23f2842a6616ce8ac884c2fb7a533efdda13"} build_url:https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011235 build_url: 'https://queue.taskcluster.net/v1/task/PsLaQHnYSb2BFXgCFWFO9A/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/sha512/4c46ae08e7b863ade59345b8a40ba71ced77f0647b04e31546992e7a97e3192942960ea716acd755b0611cbc247e3f8597010e4b53f1daccff2a776529ead677", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1c5aac74e4cbbb590efbd63c005c149a6bfec4c2dcf8fbaba6c4b3e92d31218dd294f80ac5a47958983bdeaa3aa7d607ec58b6a4be15d559235ebd83fdb85f6a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a0f6cfccbfd1f06ec1b438c3469c12e088d1f254193049ccfbc911e5608c2b103df7f542058ae47ddd0a0d88cc7c23f2842a6616ce8ac884c2fb7a533efdda13"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-04 11:27:49.118007) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-04 11:27:49.118361) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4ac8d263c7293b36a1be1aed000001be-1467654090.711749-1441026840 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004497 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-04 11:27:49.203620) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-04 11:27:49.204294) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-04 11:27:49.204878) ========= ========= Total master_lag: 0.21 =========