builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-040 starttime: 1468228744.16 results: success (0) buildid: 20160711012926 builduid: 4d62b50923894a60ad72f8fe9b9a3f05 revision: 76d556ef9180969ee8d690ed069732faded934a2 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.163383) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.164200) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.164580) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.199881) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.200252) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-11 02:19:04-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.4M=0s 2016-07-11 02:19:04 (46.4 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.093633 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.316863) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.317309) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022015 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.367789) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:04.368193) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 76d556ef9180969ee8d690ed069732faded934a2 --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 76d556ef9180969ee8d690ed069732faded934a2 --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=9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-11 02:19:04,618 truncating revision to first 12 chars 2016-07-11 02:19:04,618 Setting DEBUG logging. 2016-07-11 02:19:04,618 attempt 1/10 2016-07-11 02:19:04,618 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/76d556ef9180?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-11 02:19:04,939 unpacking tar archive at: fx-team-76d556ef9180/testing/mozharness/ program finished with exit code 0 elapsedTime=0.660882 ========= master_lag: 0.13 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:05.161811) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:05.162230) ========= script_repo_revision: 76d556ef9180969ee8d690ed069732faded934a2 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:05.162723) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:05.163010) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-11 02:19:05.221700) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-07-11 02:19:05.221998) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 02:19:05 INFO - MultiFileLogger online at 20160711 02:19:05 in /builds/slave/test 02:19:05 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 02:19:05 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:19:05 INFO - {'append_to_log': False, 02:19:05 INFO - 'base_work_dir': '/builds/slave/test', 02:19:05 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 02:19:05 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:19:05 INFO - 'branch': 'Fx-Team-Non-PGO', 02:19:05 INFO - 'buildbot_json_path': 'buildprops.json', 02:19:05 INFO - 'config_files': ('talos/linux_config.py',), 02:19:05 INFO - 'default_actions': ('clobber', 02:19:05 INFO - 'read-buildbot-config', 02:19:05 INFO - 'download-and-extract', 02:19:05 INFO - 'populate-webroot', 02:19:05 INFO - 'create-virtualenv', 02:19:05 INFO - 'install', 02:19:05 INFO - 'run-tests'), 02:19:05 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:19:05 INFO - 'download_minidump_stackwalk': True, 02:19:05 INFO - 'download_symbols': 'ondemand', 02:19:05 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 02:19:05 INFO - 'tooltool.py': '/tools/tooltool.py', 02:19:05 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 02:19:05 INFO - '/tools/misc-python/virtualenv.py')}, 02:19:05 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:19:05 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:19:05 INFO - 'installer_path': 'installer.exe', 02:19:05 INFO - 'log_level': 'info', 02:19:05 INFO - 'log_name': 'talos', 02:19:05 INFO - 'log_to_console': True, 02:19:05 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 02:19:05 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 02:19:05 INFO - 'opt_config_files': (), 02:19:05 INFO - 'pip_index': False, 02:19:05 INFO - 'sps_profile': False, 02:19:05 INFO - 'sps_profile_interval': 0, 02:19:05 INFO - 'suite': 'dromaeojs', 02:19:05 INFO - 'system_bits': '32', 02:19:05 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:19:05 INFO - 'title': 'talos-linux64-ix-040', 02:19:05 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:19:05 INFO - 'use_talos_json': True, 02:19:05 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:19:05 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:19:05 INFO - 'work_dir': 'build'} 02:19:05 INFO - ##### 02:19:05 INFO - ##### Running clobber step. 02:19:05 INFO - ##### 02:19:05 INFO - Running pre-action listener: _resource_record_pre_action 02:19:05 INFO - Running main action method: clobber 02:19:05 INFO - rmtree: /builds/slave/test/build 02:19:05 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:19:06 INFO - Running post-action listener: _resource_record_post_action 02:19:06 INFO - ##### 02:19:06 INFO - ##### Finished clobber step (success) 02:19:06 INFO - ##### 02:19:06 INFO - ##### 02:19:06 INFO - ##### Running read-buildbot-config step. 02:19:06 INFO - ##### 02:19:06 INFO - Running pre-action listener: _resource_record_pre_action 02:19:06 INFO - Running main action method: read_buildbot_config 02:19:06 INFO - Using buildbot properties: 02:19:06 INFO - { 02:19:06 INFO - "project": "", 02:19:06 INFO - "product": "firefox", 02:19:06 INFO - "script_repo_revision": "production", 02:19:06 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 02:19:06 INFO - "repository": "", 02:19:06 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 02:19:06 INFO - "buildid": "20160711012926", 02:19:06 INFO - "pgo_build": "False", 02:19:06 INFO - "basedir": "/builds/slave/test", 02:19:06 INFO - "buildnumber": 1962, 02:19:06 INFO - "slavename": "talos-linux64-ix-040", 02:19:06 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 02:19:06 INFO - "platform": "ubuntu64_hw", 02:19:06 INFO - "scheduler": "tests-fx-team-linux64-talos", 02:19:06 INFO - "branch": "fx-team", 02:19:06 INFO - "repo_path": "integration/fx-team", 02:19:06 INFO - "revision": "76d556ef9180969ee8d690ed069732faded934a2", 02:19:06 INFO - "stage_platform": "linux64", 02:19:06 INFO - "builduid": "4d62b50923894a60ad72f8fe9b9a3f05", 02:19:06 INFO - "slavebuilddir": "test" 02:19:06 INFO - } 02:19:06 INFO - Found installer url https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 02:19:06 INFO - Running post-action listener: _resource_record_post_action 02:19:06 INFO - ##### 02:19:06 INFO - ##### Finished read-buildbot-config step (success) 02:19:06 INFO - ##### 02:19:06 INFO - ##### 02:19:06 INFO - ##### Running download-and-extract step. 02:19:06 INFO - ##### 02:19:06 INFO - Running pre-action listener: _resource_record_pre_action 02:19:06 INFO - Running main action method: download_and_extract 02:19:06 INFO - mkdir: /builds/slave/test/build/tests 02:19:06 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')]} 02:19:06 INFO - https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 02:19:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 02:19:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 02:19:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:06 INFO - Downloaded 1361 bytes. 02:19:06 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 02:19:06 INFO - Using the following test package requirements: 02:19:06 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 02:19:06 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:19:06 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 02:19:06 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:19:06 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 02:19:06 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:19:06 INFO - u'jsshell-linux-x86_64.zip'], 02:19:06 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:19:06 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 02:19:06 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 02:19:06 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:19:06 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 02:19:06 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:19:06 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 02:19:06 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:19:06 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 02:19:06 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 02:19:06 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 02:19:06 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 02:19:06 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')]} 02:19:06 INFO - https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 02:19:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 02:19:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 02:19:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:08 INFO - Downloaded 22735150 bytes. 02:19:08 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'] 02:19:08 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 02:19:09 INFO - Return code: 0 02:19:09 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 02:19:09 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')]} 02:19:09 INFO - https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 02:19:09 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 02:19:09 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 02:19:09 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:11 INFO - Downloaded 22735150 bytes. 02:19:11 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'] 02:19:11 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 02:19:12 INFO - Return code: 0 02:19:12 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')]} 02:19:12 INFO - https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 02:19:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 02:19:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 02:19:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:14 INFO - Downloaded 14403333 bytes. 02:19:14 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'] 02:19:14 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 02:19:14 INFO - Return code: 0 02:19:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:14 INFO - https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 02:19:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 02:19:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 02:19:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TnMksO4vTs61XSIpKzJdsA/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 02:19:16 INFO - Downloaded 56654534 bytes. 02:19:16 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 02:19:16 INFO - mkdir: /builds/slave/test/properties 02:19:16 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:19:16 INFO - Writing to file /builds/slave/test/properties/build_url 02:19:16 INFO - Contents: 02:19:16 INFO - build_url:https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 02:19:17 INFO - Running post-action listener: _resource_record_post_action 02:19:17 INFO - Running post-action listener: set_extra_try_arguments 02:19:17 INFO - ##### 02:19:17 INFO - ##### Finished download-and-extract step (success) 02:19:17 INFO - ##### 02:19:17 INFO - ##### 02:19:17 INFO - ##### Running populate-webroot step. 02:19:17 INFO - ##### 02:19:17 INFO - Running pre-action listener: _resource_record_pre_action 02:19:17 INFO - Running main action method: populate_webroot 02:19:17 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 02:19:17 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 02:19:17 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 02:19:17 INFO - '--tppagecycles', 02:19:17 INFO - '7'], 02:19:17 INFO - 'tests': ['tsvgm']}}, 02:19:17 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['tresize', 'tcanvasmark']}, 02:19:17 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 02:19:17 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['dromaeo_css', 'kraken']}, 02:19:17 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 02:19:17 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:19:17 INFO - 'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:19:17 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:19:17 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:19:17 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:19:17 INFO - 'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['damp', 'tps']}, 02:19:17 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:19:17 INFO - 'tests': ['damp', 'tps']}, 02:19:17 INFO - 'g3': {'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['dromaeo_dom']}, 02:19:17 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:19:17 INFO - 'g4': {'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['basic_compositor_video']}, 02:19:17 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 02:19:17 INFO - 'other': {'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['a11yr', 02:19:17 INFO - 'ts_paint', 02:19:17 INFO - 'tpaint', 02:19:17 INFO - 'sessionrestore', 02:19:17 INFO - 'sessionrestore_no_auto_restore', 02:19:17 INFO - 'tabpaint']}, 02:19:17 INFO - 'other-e10s': {'tests': ['a11yr', 02:19:17 INFO - 'ts_paint', 02:19:17 INFO - 'tpaint', 02:19:17 INFO - 'sessionrestore', 02:19:17 INFO - 'sessionrestore_no_auto_restore', 02:19:17 INFO - 'tabpaint']}, 02:19:17 INFO - 'other-e10s_l64': {'tests': ['a11yr', 02:19:17 INFO - 'ts_paint', 02:19:17 INFO - 'tpaint', 02:19:17 INFO - 'sessionrestore', 02:19:17 INFO - 'sessionrestore_no_auto_restore', 02:19:17 INFO - 'tabpaint']}, 02:19:17 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 02:19:17 INFO - 'ts_paint', 02:19:17 INFO - 'tpaint', 02:19:17 INFO - 'sessionrestore', 02:19:17 INFO - 'sessionrestore_no_auto_restore', 02:19:17 INFO - 'tabpaint']}, 02:19:17 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['a11yr', 02:19:17 INFO - 'ts_paint', 02:19:17 INFO - 'tpaint', 02:19:17 INFO - 'sessionrestore', 02:19:17 INFO - 'sessionrestore_no_auto_restore', 02:19:17 INFO - 'tabpaint']}, 02:19:17 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['a11yr', 02:19:17 INFO - 'ts_paint', 02:19:17 INFO - 'tpaint', 02:19:17 INFO - 'sessionrestore', 02:19:17 INFO - 'sessionrestore_no_auto_restore', 02:19:17 INFO - 'tabpaint']}, 02:19:17 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['tsvgx', 02:19:17 INFO - 'tsvgr_opacity', 02:19:17 INFO - 'tart', 02:19:17 INFO - 'tscrollx', 02:19:17 INFO - 'cart']}, 02:19:17 INFO - 'svgr-e10s': {'tests': ['tsvgx', 02:19:17 INFO - 'tsvgr_opacity', 02:19:17 INFO - 'tart', 02:19:17 INFO - 'tscrollx', 02:19:17 INFO - 'cart']}, 02:19:17 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:19:17 INFO - 'talos_options': ['--disable-e10s'], 02:19:17 INFO - 'tests': ['tp5o']}, 02:19:17 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:19:17 INFO - 'tests': ['tp5o']}, 02:19:17 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:19:17 INFO - 'talos_options': ['--disable-e10s', 02:19:17 INFO - '--xperf_path', 02:19:17 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:19:17 INFO - 'tests': ['tp5n']}, 02:19:17 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:19:17 INFO - 'talos_options': ['--xperf_path', 02:19:17 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:19:17 INFO - 'tests': ['tp5n']}}, 02:19:17 INFO - 'talos.zip': {'path': '', 02:19:17 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 02:19:17 INFO - Running post-action listener: _resource_record_post_action 02:19:17 INFO - ##### 02:19:17 INFO - ##### Finished populate-webroot step (success) 02:19:17 INFO - ##### 02:19:17 INFO - ##### 02:19:17 INFO - ##### Running create-virtualenv step. 02:19:17 INFO - ##### 02:19:17 INFO - Running pre-action listener: _resource_record_pre_action 02:19:17 INFO - Running main action method: create_virtualenv 02:19:17 INFO - Creating virtualenv /builds/slave/test/build/venv 02:19:17 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 02:19:17 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 02:19:17 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:19:17 INFO - Using real prefix '/usr' 02:19:17 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:19:17 INFO - Installing distribute.............................................................................................................................................................................................done. 02:19:19 INFO - Installing pip.................done. 02:19:19 INFO - Return code: 0 02:19:19 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:19:19 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')]} 02:19:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:19 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')]} 02:19:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:19 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 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:19 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 02:19:19 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 02:19:19 INFO - Using env: {'DISPLAY': ':0', 02:19:19 INFO - 'HOME': '/home/cltbld', 02:19:19 INFO - 'LANG': 'en_US.UTF-8', 02:19:19 INFO - 'LANGUAGE': 'en_US:en', 02:19:19 INFO - 'LOGNAME': 'cltbld', 02:19:19 INFO - 'MAIL': '/var/mail/cltbld', 02:19:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:19 INFO - 'MOZ_NO_REMOTE': '1', 02:19:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:19 INFO - 'NO_EM_RESTART': '1', 02:19:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:19 INFO - 'PWD': '/builds/slave/test', 02:19:19 INFO - 'SHELL': '/bin/bash', 02:19:19 INFO - 'SHLVL': '1', 02:19:19 INFO - 'TERM': 'linux', 02:19:19 INFO - 'TMOUT': '86400', 02:19:19 INFO - 'USER': 'cltbld', 02:19:19 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:19 INFO - '_': '/tools/buildbot/bin/python'} 02:19:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:20 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 02:19:20 INFO - Cleaning up... 02:19:20 INFO - Return code: 0 02:19:20 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 02:19:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:20 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 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:20 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 02:19:20 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 02:19:20 INFO - Using env: {'DISPLAY': ':0', 02:19:20 INFO - 'HOME': '/home/cltbld', 02:19:20 INFO - 'LANG': 'en_US.UTF-8', 02:19:20 INFO - 'LANGUAGE': 'en_US:en', 02:19:20 INFO - 'LOGNAME': 'cltbld', 02:19:20 INFO - 'MAIL': '/var/mail/cltbld', 02:19:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:20 INFO - 'MOZ_NO_REMOTE': '1', 02:19:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:20 INFO - 'NO_EM_RESTART': '1', 02:19:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:20 INFO - 'PWD': '/builds/slave/test', 02:19:20 INFO - 'SHELL': '/bin/bash', 02:19:20 INFO - 'SHLVL': '1', 02:19:20 INFO - 'TERM': 'linux', 02:19:20 INFO - 'TMOUT': '86400', 02:19:20 INFO - 'USER': 'cltbld', 02:19:20 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:20 INFO - '_': '/tools/buildbot/bin/python'} 02:19:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:20 INFO - Downloading/unpacking psutil>=3.1.1 02:19:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:19:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:19:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:19:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:19:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:19:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:19:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:19:22 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:19:22 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:19:22 INFO - Installing collected packages: psutil 02:19:22 INFO - Running setup.py install for psutil 02:19:22 INFO - building 'psutil._psutil_linux' extension 02:19:22 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 02:19:22 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 02:19:22 INFO - building 'psutil._psutil_posix' extension 02:19:22 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 02:19:22 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 02:19:22 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:19:22 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:19:22 INFO - Successfully installed psutil 02:19:22 INFO - Cleaning up... 02:19:22 INFO - Return code: 0 02:19:22 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 02:19: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')]} 02:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19: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')]} 02:19:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:22 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 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:22 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 02:19:22 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 02:19:22 INFO - Using env: {'DISPLAY': ':0', 02:19:22 INFO - 'HOME': '/home/cltbld', 02:19:22 INFO - 'LANG': 'en_US.UTF-8', 02:19:22 INFO - 'LANGUAGE': 'en_US:en', 02:19:22 INFO - 'LOGNAME': 'cltbld', 02:19:22 INFO - 'MAIL': '/var/mail/cltbld', 02:19:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:22 INFO - 'MOZ_NO_REMOTE': '1', 02:19:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:22 INFO - 'NO_EM_RESTART': '1', 02:19:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:22 INFO - 'PWD': '/builds/slave/test', 02:19:22 INFO - 'SHELL': '/bin/bash', 02:19:22 INFO - 'SHLVL': '1', 02:19:22 INFO - 'TERM': 'linux', 02:19:22 INFO - 'TMOUT': '86400', 02:19:22 INFO - 'USER': 'cltbld', 02:19:22 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:22 INFO - '_': '/tools/buildbot/bin/python'} 02:19:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:22 INFO - Downloading/unpacking mozsystemmonitor==0.3 02:19:22 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 02:19:22 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 02:19:22 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 02:19:22 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 02:19:22 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 02:19:22 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 02:19:24 INFO - Downloading mozsystemmonitor-0.3.tar.gz 02:19:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:19:24 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 02:19:24 INFO - Installing collected packages: mozsystemmonitor 02:19:24 INFO - Running setup.py install for mozsystemmonitor 02:19:25 INFO - Successfully installed mozsystemmonitor 02:19:25 INFO - Cleaning up... 02:19:25 INFO - Return code: 0 02:19:25 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 02:19: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')]} 02:19:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19: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')]} 02:19:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:25 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 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:25 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 02:19:25 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 02:19:25 INFO - Using env: {'DISPLAY': ':0', 02:19:25 INFO - 'HOME': '/home/cltbld', 02:19:25 INFO - 'LANG': 'en_US.UTF-8', 02:19:25 INFO - 'LANGUAGE': 'en_US:en', 02:19:25 INFO - 'LOGNAME': 'cltbld', 02:19:25 INFO - 'MAIL': '/var/mail/cltbld', 02:19:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:25 INFO - 'MOZ_NO_REMOTE': '1', 02:19:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:25 INFO - 'NO_EM_RESTART': '1', 02:19:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:25 INFO - 'PWD': '/builds/slave/test', 02:19:25 INFO - 'SHELL': '/bin/bash', 02:19:25 INFO - 'SHLVL': '1', 02:19:25 INFO - 'TERM': 'linux', 02:19:25 INFO - 'TMOUT': '86400', 02:19:25 INFO - 'USER': 'cltbld', 02:19:25 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:25 INFO - '_': '/tools/buildbot/bin/python'} 02:19:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:25 INFO - Downloading/unpacking jsonschema==2.5.1 02:19:25 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 02:19:25 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 02:19:25 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 02:19:25 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 02:19:25 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 02:19:25 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 02:19:27 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:19:27 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 02:19:27 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 02:19:27 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 02:19:27 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 02:19:27 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 02:19:27 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 02:19:27 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 02:19:27 INFO - Downloading functools32-3.2.3-2.tar.gz 02:19:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:19:27 INFO - warning: no files found matching '*.txt' 02:19:27 INFO - no previously-included directories found matching 'build' 02:19:27 INFO - no previously-included directories found matching 'dist' 02:19:27 INFO - no previously-included directories found matching '.git*' 02:19:27 INFO - Installing collected packages: jsonschema, functools32 02:19:27 INFO - Running setup.py install for functools32 02:19:27 INFO - warning: no files found matching '*.txt' 02:19:27 INFO - no previously-included directories found matching 'build' 02:19:27 INFO - no previously-included directories found matching 'dist' 02:19:27 INFO - no previously-included directories found matching '.git*' 02:19:27 INFO - Successfully installed jsonschema functools32 02:19:27 INFO - Cleaning up... 02:19:27 INFO - Return code: 0 02:19:27 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:19: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')]} 02:19:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19: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')]} 02:19:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:27 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 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:27 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 02:19:27 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 02:19:27 INFO - Using env: {'DISPLAY': ':0', 02:19:27 INFO - 'HOME': '/home/cltbld', 02:19:27 INFO - 'LANG': 'en_US.UTF-8', 02:19:27 INFO - 'LANGUAGE': 'en_US:en', 02:19:27 INFO - 'LOGNAME': 'cltbld', 02:19:27 INFO - 'MAIL': '/var/mail/cltbld', 02:19:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:27 INFO - 'MOZ_NO_REMOTE': '1', 02:19:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:27 INFO - 'NO_EM_RESTART': '1', 02:19:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:27 INFO - 'PWD': '/builds/slave/test', 02:19:27 INFO - 'SHELL': '/bin/bash', 02:19:27 INFO - 'SHLVL': '1', 02:19:27 INFO - 'TERM': 'linux', 02:19:27 INFO - 'TMOUT': '86400', 02:19:27 INFO - 'USER': 'cltbld', 02:19:27 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:27 INFO - '_': '/tools/buildbot/bin/python'} 02:19:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:27 INFO - Downloading/unpacking blobuploader==1.2.4 02:19:27 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 02:19:27 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 02:19:27 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 02:19:27 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 02:19:27 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 02:19:27 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 02:19:29 INFO - Downloading blobuploader-1.2.4.tar.gz 02:19:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:19:29 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:19:29 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 02:19:29 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 02:19:29 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 02:19:29 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 02:19:29 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 02:19:29 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 02:19:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:19:30 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:19:30 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 02:19:30 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 02:19:30 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 02:19:30 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 02:19:30 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 02:19:30 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 02:19:30 INFO - Downloading docopt-0.6.1.tar.gz 02:19:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:19:30 INFO - Installing collected packages: blobuploader, requests, docopt 02:19:30 INFO - Running setup.py install for blobuploader 02:19:30 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:19:30 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:19:30 INFO - Running setup.py install for requests 02:19:30 INFO - Running setup.py install for docopt 02:19:31 INFO - Successfully installed blobuploader requests docopt 02:19:31 INFO - Cleaning up... 02:19:31 INFO - Return code: 0 02:19:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:19:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:31 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 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:31 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 02:19:31 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 02:19:31 INFO - Using env: {'DISPLAY': ':0', 02:19:31 INFO - 'HOME': '/home/cltbld', 02:19:31 INFO - 'LANG': 'en_US.UTF-8', 02:19:31 INFO - 'LANGUAGE': 'en_US:en', 02:19:31 INFO - 'LOGNAME': 'cltbld', 02:19:31 INFO - 'MAIL': '/var/mail/cltbld', 02:19:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:31 INFO - 'MOZ_NO_REMOTE': '1', 02:19:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:31 INFO - 'NO_EM_RESTART': '1', 02:19:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:31 INFO - 'PWD': '/builds/slave/test', 02:19:31 INFO - 'SHELL': '/bin/bash', 02:19:31 INFO - 'SHLVL': '1', 02:19:31 INFO - 'TERM': 'linux', 02:19:31 INFO - 'TMOUT': '86400', 02:19:31 INFO - 'USER': 'cltbld', 02:19:31 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:31 INFO - '_': '/tools/buildbot/bin/python'} 02:19:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:19:31 INFO - Running setup.py (path:/tmp/pip-zEZx2g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:19:31 INFO - Running setup.py (path:/tmp/pip-V_clWJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:19:31 INFO - Running setup.py (path:/tmp/pip-EbPztd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:19:31 INFO - Running setup.py (path:/tmp/pip-rtIg_l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:19:31 INFO - Running setup.py (path:/tmp/pip-miA0EA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:19:31 INFO - Running setup.py (path:/tmp/pip-IYV0S1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:19:31 INFO - Running setup.py (path:/tmp/pip-tys0qP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:19:31 INFO - Running setup.py (path:/tmp/pip-POd7YT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:19:31 INFO - Running setup.py (path:/tmp/pip-PLlSQo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:19:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:19:31 INFO - Running setup.py (path:/tmp/pip-gaurB0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:19:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:19:32 INFO - Running setup.py (path:/tmp/pip-J9GAVa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:19:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:19:32 INFO - Running setup.py (path:/tmp/pip-_mt8am-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:19:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:19:32 INFO - Running setup.py (path:/tmp/pip-peCijM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:19:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:19:32 INFO - Running setup.py (path:/tmp/pip-hzKU9c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:19:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:19:32 INFO - Running setup.py (path:/tmp/pip-v2NTx6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:19:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:19:32 INFO - Running setup.py (path:/tmp/pip-dN77NK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:19:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:19:32 INFO - Running setup.py (path:/tmp/pip-1jYhZU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:19:32 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:19:32 INFO - Running setup.py install for manifestparser 02:19:32 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:19:32 INFO - Running setup.py install for mozcrash 02:19:32 INFO - Running setup.py install for mozdebug 02:19:32 INFO - Running setup.py install for mozdevice 02:19:32 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 02:19:32 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:19:32 INFO - Running setup.py install for mozfile 02:19:33 INFO - Running setup.py install for mozhttpd 02:19:33 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Running setup.py install for mozinfo 02:19:33 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Running setup.py install for mozInstall 02:19:33 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Running setup.py install for mozleak 02:19:33 INFO - Running setup.py install for mozlog 02:19:33 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Running setup.py install for moznetwork 02:19:33 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Running setup.py install for mozprocess 02:19:33 INFO - Running setup.py install for mozprofile 02:19:33 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:19:33 INFO - Running setup.py install for mozrunner 02:19:34 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:19:34 INFO - Running setup.py install for mozscreenshot 02:19:34 INFO - Running setup.py install for moztest 02:19:34 INFO - Running setup.py install for mozversion 02:19:34 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:19:34 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:19:34 INFO - Cleaning up... 02:19:34 INFO - Return code: 0 02:19:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:19: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')]} 02:19:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19: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')]} 02:19:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:34 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 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:34 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 02:19:34 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 02:19:34 INFO - Using env: {'DISPLAY': ':0', 02:19:34 INFO - 'HOME': '/home/cltbld', 02:19:34 INFO - 'LANG': 'en_US.UTF-8', 02:19:34 INFO - 'LANGUAGE': 'en_US:en', 02:19:34 INFO - 'LOGNAME': 'cltbld', 02:19:34 INFO - 'MAIL': '/var/mail/cltbld', 02:19:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:34 INFO - 'MOZ_NO_REMOTE': '1', 02:19:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:34 INFO - 'NO_EM_RESTART': '1', 02:19:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:34 INFO - 'PWD': '/builds/slave/test', 02:19:34 INFO - 'SHELL': '/bin/bash', 02:19:34 INFO - 'SHLVL': '1', 02:19:34 INFO - 'TERM': 'linux', 02:19:34 INFO - 'TMOUT': '86400', 02:19:34 INFO - 'USER': 'cltbld', 02:19:34 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:34 INFO - '_': '/tools/buildbot/bin/python'} 02:19:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:19:34 INFO - Running setup.py (path:/tmp/pip-Zs0ncn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:19:34 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)) 02:19:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:19:34 INFO - Running setup.py (path:/tmp/pip-XNgIA_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:19:34 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)) 02:19:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:19:34 INFO - Running setup.py (path:/tmp/pip-NCK2n1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:19:34 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)) 02:19:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:19:34 INFO - Running setup.py (path:/tmp/pip-Jc04Vl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:19:34 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)) 02:19:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:19:34 INFO - Running setup.py (path:/tmp/pip-CxsEg5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:19:34 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)) 02:19:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:19:34 INFO - Running setup.py (path:/tmp/pip-LcVXqv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:19:35 INFO - Running setup.py (path:/tmp/pip-lM3TeF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:19:35 INFO - Running setup.py (path:/tmp/pip-wP1Go2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:19:35 INFO - Running setup.py (path:/tmp/pip-xn_Yyk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:19:35 INFO - Running setup.py (path:/tmp/pip-nX0qYM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:19:35 INFO - Running setup.py (path:/tmp/pip-5orsaB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:19:35 INFO - Running setup.py (path:/tmp/pip-3MbwtL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:19:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:19:35 INFO - Running setup.py (path:/tmp/pip-BrmKGt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:19:35 INFO - Running setup.py (path:/tmp/pip-SOqUOh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:19:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:19:35 INFO - Running setup.py (path:/tmp/pip-81mvOH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:19:35 INFO - Running setup.py (path:/tmp/pip-LYszeq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:19:35 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)) 02:19:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:19:35 INFO - Running setup.py (path:/tmp/pip-s8ebIW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:19:35 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)) 02:19:35 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)) 02:19:35 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)) 02:19:35 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)) 02:19:35 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)) 02:19:35 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)) 02:19:35 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:19:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:19:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:19:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:19:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:19:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:19:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:19:37 INFO - Downloading blessings-1.6.tar.gz 02:19:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:19:37 INFO - Installing collected packages: blessings 02:19:37 INFO - Running setup.py install for blessings 02:19:37 INFO - Successfully installed blessings 02:19:37 INFO - Cleaning up... 02:19:37 INFO - Return code: 0 02:19:37 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:19:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:19:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:19:38 INFO - Reading from file tmpfile_stdout 02:19:38 INFO - Current package versions: 02:19:38 INFO - argparse == 1.2.1 02:19:38 INFO - blessings == 1.6 02:19:38 INFO - blobuploader == 1.2.4 02:19:38 INFO - docopt == 0.6.1 02:19:38 INFO - functools32 == 3.2.3-2 02:19:38 INFO - jsonschema == 2.5.1 02:19:38 INFO - manifestparser == 1.1 02:19:38 INFO - mozInstall == 1.12 02:19:38 INFO - mozcrash == 0.17 02:19:38 INFO - mozdebug == 0.1 02:19:38 INFO - mozdevice == 0.48 02:19:38 INFO - mozfile == 1.2 02:19:38 INFO - mozhttpd == 0.7 02:19:38 INFO - mozinfo == 0.9 02:19:38 INFO - mozleak == 0.1 02:19:38 INFO - mozlog == 3.2 02:19:38 INFO - moznetwork == 0.27 02:19:38 INFO - mozprocess == 0.23 02:19:38 INFO - mozprofile == 0.28 02:19:38 INFO - mozrunner == 6.12 02:19:38 INFO - mozscreenshot == 0.1 02:19:38 INFO - mozsystemmonitor == 0.3 02:19:38 INFO - moztest == 0.7 02:19:38 INFO - mozversion == 1.4 02:19:38 INFO - psutil == 3.1.1 02:19:38 INFO - requests == 1.2.3 02:19:38 INFO - wsgiref == 0.1.2 02:19:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:19:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:38 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 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:38 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 02:19:38 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 02:19:38 INFO - Using env: {'DISPLAY': ':0', 02:19:38 INFO - 'HOME': '/home/cltbld', 02:19:38 INFO - 'LANG': 'en_US.UTF-8', 02:19:38 INFO - 'LANGUAGE': 'en_US:en', 02:19:38 INFO - 'LOGNAME': 'cltbld', 02:19:38 INFO - 'MAIL': '/var/mail/cltbld', 02:19:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:38 INFO - 'MOZ_NO_REMOTE': '1', 02:19:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:38 INFO - 'NO_EM_RESTART': '1', 02:19:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:38 INFO - 'PWD': '/builds/slave/test', 02:19:38 INFO - 'SHELL': '/bin/bash', 02:19:38 INFO - 'SHLVL': '1', 02:19:38 INFO - 'TERM': 'linux', 02:19:38 INFO - 'TMOUT': '86400', 02:19:38 INFO - 'USER': 'cltbld', 02:19:38 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:38 INFO - '_': '/tools/buildbot/bin/python'} 02:19:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 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)) 02:19:38 INFO - Cleaning up... 02:19:38 INFO - Return code: 0 02:19:38 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:19:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:19:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:19:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:19:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:19:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x208f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2350180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', '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 02:19:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 02:19:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 02:19:38 INFO - Using env: {'DISPLAY': ':0', 02:19:38 INFO - 'HOME': '/home/cltbld', 02:19:38 INFO - 'LANG': 'en_US.UTF-8', 02:19:38 INFO - 'LANGUAGE': 'en_US:en', 02:19:38 INFO - 'LOGNAME': 'cltbld', 02:19:38 INFO - 'MAIL': '/var/mail/cltbld', 02:19:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:38 INFO - 'MOZ_NO_REMOTE': '1', 02:19:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:38 INFO - 'NO_EM_RESTART': '1', 02:19:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:38 INFO - 'PWD': '/builds/slave/test', 02:19:38 INFO - 'SHELL': '/bin/bash', 02:19:38 INFO - 'SHLVL': '1', 02:19:38 INFO - 'TERM': 'linux', 02:19:38 INFO - 'TMOUT': '86400', 02:19:38 INFO - 'USER': 'cltbld', 02:19:38 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:38 INFO - '_': '/tools/buildbot/bin/python'} 02:19:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:19:38 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 02:19:38 INFO - Cleaning up... 02:19:38 INFO - Return code: 0 02:19:38 INFO - Running post-action listener: _resource_record_post_action 02:19:38 INFO - Running post-action listener: _start_resource_monitoring 02:19:38 INFO - Starting resource monitoring. 02:19:38 INFO - ##### 02:19:38 INFO - ##### Finished create-virtualenv step (success) 02:19:38 INFO - ##### 02:19:38 INFO - ##### 02:19:38 INFO - ##### Running install step. 02:19:38 INFO - ##### 02:19:38 INFO - Running pre-action listener: _resource_record_pre_action 02:19:38 INFO - Running main action method: install 02:19:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:19:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:19:38 INFO - Reading from file tmpfile_stdout 02:19:38 INFO - Detecting whether we're running mozinstall >=1.0... 02:19:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:19:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:19:38 INFO - Reading from file tmpfile_stdout 02:19:38 INFO - Output received: 02:19:38 INFO - Usage: mozinstall [options] installer 02:19:38 INFO - Options: 02:19:38 INFO - -h, --help show this help message and exit 02:19:38 INFO - -d DEST, --destination=DEST 02:19:38 INFO - Directory to install application into. [default: 02:19:38 INFO - "/builds/slave/test"] 02:19:38 INFO - --app=APP Application being installed. [default: firefox] 02:19:38 INFO - mkdir: /builds/slave/test/build/application 02:19:38 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'] 02:19:38 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 02:19:55 INFO - Reading from file tmpfile_stdout 02:19:55 INFO - Output received: 02:19:55 INFO - /builds/slave/test/build/application/firefox/firefox 02:19:55 INFO - Running post-action listener: _resource_record_post_action 02:19:55 INFO - ##### 02:19:55 INFO - ##### Finished install step (success) 02:19:55 INFO - ##### 02:19:55 INFO - ##### 02:19:55 INFO - ##### Running run-tests step. 02:19:55 INFO - ##### 02:19:55 INFO - Running pre-action listener: _resource_record_pre_action 02:19:55 INFO - Running main action method: run_tests 02:19:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:19:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:19:55 INFO - Python 2.7.3 02:19:55 INFO - Return code: 0 02:19:55 INFO - grabbing minidump binary from tooltool 02:19:55 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')]} 02:19:55 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 0x234e3b0>, '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 0x234f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x234f740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:19:55 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 02:19:55 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 02:19:55 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 02:19:55 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:19:55 INFO - Return code: 0 02:19:55 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 02:19:55 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:19:55 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:19:55 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 02:19:55 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:19:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-040', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 02:19:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-040 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 02:19:55 INFO - Using env: {'DISPLAY': ':0', 02:19:55 INFO - 'HOME': '/home/cltbld', 02:19:55 INFO - 'LANG': 'en_US.UTF-8', 02:19:55 INFO - 'LANGUAGE': 'en_US:en', 02:19:55 INFO - 'LOGNAME': 'cltbld', 02:19:55 INFO - 'MAIL': '/var/mail/cltbld', 02:19:55 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:19:55 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 02:19:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:19:55 INFO - 'MOZ_NO_REMOTE': '1', 02:19:55 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:19:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:19:55 INFO - 'NO_EM_RESTART': '1', 02:19:55 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:19:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:19:55 INFO - 'PWD': '/builds/slave/test', 02:19:55 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:19:55 INFO - 'SHELL': '/bin/bash', 02:19:55 INFO - 'SHLVL': '1', 02:19:55 INFO - 'TERM': 'linux', 02:19:55 INFO - 'TMOUT': '86400', 02:19:55 INFO - 'USER': 'cltbld', 02:19:55 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050', 02:19:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:19:55 INFO - '_': '/tools/buildbot/bin/python'} 02:19:55 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-040', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 02:19:55 INFO - mozversion application_buildid: 20160711012926 02:19:55 INFO - mozversion application_changeset: 76d556ef9180969ee8d690ed069732faded934a2 02:19:55 INFO - mozversion application_display_name: Nightly 02:19:55 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:19:55 INFO - mozversion application_name: Firefox 02:19:55 INFO - mozversion application_remotingname: firefox 02:19:55 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 02:19:55 INFO - mozversion application_vendor: Mozilla 02:19:55 INFO - mozversion application_version: 50.0a1 02:19:55 INFO - mozversion platform_buildid: 20160711012926 02:19:55 INFO - mozversion platform_changeset: 76d556ef9180969ee8d690ed069732faded934a2 02:19:55 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 02:19:55 INFO - mozversion platform_version: 50.0a1 02:19:55 INFO - using testdate: 1468228795 02:19:55 INFO - actual date: 1468228795 02:19:55 INFO - starting webserver on 'localhost:52677' 02:19:55 INFO - SUITE-START | Running 2 tests 02:19:55 INFO - TEST-START | dromaeo_css 02:19:55 INFO - operating with platform_type : linux_ 02:19:55 INFO - Initialising browser for dromaeo_css test... 02:19:55 INFO - TEST-INFO | started process 13924 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4ku93a/profile http://localhost:52677/getInfo.html) 02:19:59 INFO - PROCESS | 13924 | __metrics Screen width/height:1600/1200 02:19:59 INFO - PROCESS | 13924 | colorDepth:24 02:19:59 INFO - PROCESS | 13924 | Browser inner width/height: 1024/697 02:19:59 INFO - PROCESS | 13924 | __metrics 02:20:00 INFO - PROCESS | 13924 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 02:20:00 INFO - PROCESS | 13924 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 02:20:01 INFO - TEST-INFO | 13924: exit 0 02:20:01 INFO - Browser initialized. 02:20:01 INFO - Running cycle 1/1 for dromaeo_css test... 02:20:01 INFO - TEST-INFO | started process 14006 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4ku93a/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:20:13 INFO - PROCESS | 14006 | RSS: Main: 158957568 02:20:13 INFO - PROCESS | 14006 | 02:21:05 INFO - PROCESS | 14006 | 1468228865532 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] 02:23:17 INFO - PROCESS | 14006 | Cycle 1(1): loaded http://localhost:52677/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52677/tests/dromaeo/cssquery-ext.html) 02:23:18 INFO - PROCESS | 14006 | RSS: Main: 239984640 02:23:18 INFO - PROCESS | 14006 | 02:26:20 INFO - PROCESS | 14006 | Cycle 1(1): loaded http://localhost:52677/tests/dromaeo/cssquery-ext.html (next: http://localhost:52677/tests/dromaeo/cssquery-jquery.html) 02:26:21 INFO - PROCESS | 14006 | RSS: Main: 245592064 02:26:21 INFO - PROCESS | 14006 | 02:29:23 INFO - PROCESS | 14006 | Cycle 1(1): loaded http://localhost:52677/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52677/tests/dromaeo/cssquery-mootools.html) 02:29:24 INFO - PROCESS | 14006 | RSS: Main: 246628352 02:29:24 INFO - PROCESS | 14006 | 02:32:26 INFO - PROCESS | 14006 | Cycle 1(1): loaded http://localhost:52677/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52677/tests/dromaeo/cssquery-prototype.html) 02:32:27 INFO - PROCESS | 14006 | RSS: Main: 242606080 02:32:27 INFO - PROCESS | 14006 | 02:35:30 INFO - PROCESS | 14006 | Cycle 1(1): loaded http://localhost:52677/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52677/tests/dromaeo/cssquery-yui.html) 02:35:30 INFO - PROCESS | 14006 | RSS: Main: 218193920 02:35:30 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | Cycle 1(1): loaded http://localhost:52677/tests/dromaeo/cssquery-yui.html (next: http://localhost:52677/tests/dromaeo/cssquery-dojo.html) 02:38:33 INFO - PROCESS | 14006 | RSS: Main: 276320256 02:38:33 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | __start_tp_report 02:38:33 INFO - PROCESS | 14006 | _x_x_mozilla_page_load 02:38:33 INFO - PROCESS | 14006 | _x_x_mozilla_page_load_details 02:38:33 INFO - PROCESS | 14006 | |i|pagename|runs| 02:38:33 INFO - PROCESS | 14006 | |0;dojo.html;2545.096490745785;2547.2103647869176;2579.4325248445334;2581.3030481769924;2588.2752829207816;4477.664175186866;4550.522195169509;4550.590446859786;4560.133574620824;4571.657125715568;4482.260427029544;4523.570260825217;4525.841595544157;4548.181327361073;4553.817847286105;3925;4105.671546276299;4159.83360665573;4169.3954376615375;4273.423087883127;4193.35003074524;4243.72415792974;4253.553376895427;4278.764667943262;4285.914281714364;4102.118044620391;4126.834926602933;4129.988152902528;4137.586241375869;4142.2751018571935;4148.43996060531;4170.541240463546;4214.704970652056;4217.746935183899;4218.472690913636;4189.622933935961;4191.7694526801015;4197.727147735418;4213.810378532973;4234.386014027979;4389.802458889358;4526.524714904954;4581.106684196583;4584.449866016066;4626.352310676474;4923.08922849274;4933.851984440473;4944.184209605411;4944.60443164546;4944.8763780905765;4789.449213340476;4912.336834527328;4934.975325123387;4951.777170027357;4962.900741985176;4557.56703113207;4605.562471565196;4607.723536587815;4610.216263235258;4611.9077618447445;4994.725290109006;5073.543381095719;5075.974620126875;5077.568406685399;5086.92369614456;4706.129366067288;4794.065157294364;4849.933014736752;4877.3903262092235;4879.975600122048;4915.16442204826;4918.6556941014505;4929.482404347564;4933.876653083702;4935.975320123376;4821.4696383397795;4834;4836.202026665631;4837.758112094381;4882.658213925062;4721.6458765592715;4738.5261473853025;4797.616190704735;4818.614510839125;4819.734914579732;4115.54728979812;4118.299889018874;4118.732282401635;4142.855000074983;4155.002799328139;3616.27674465108;3620.167361506868;3625.220577575834;3635.818209089535;3659.963400365962;4148.896277593024;4164.66682665386;4169.520505141887;4184.184084103571;4250.383694364362;4740.19416699162;4745.905081898342;4753.691010084333;4804.375431193992;4816.783244753994;4152.294110001307;4157.750534967911;4166.541680415152;4171.770552619574;4205.957940420618;4278.7860606969525;4329.15581461612;4329.32895401207;4367.27939889921;4367.868963931087;4534.478534968389;4559.338895860015;4562.771861406983;4566.8173273068705;4593.035462552768;4813.061453016629;4819.879503012313;4822.821484288026;4828.203346447796;4874.53691899269;4502.3921770561865;4580.725156490621;4606.930896036495;4622.930656040095;4627.53724627548;4771.6898401603785;4773.928391074206;4774.809007639656;4783.928241076456;4808.254720518185;4752.738599377068;4837.322774811459;4856.441509226484;4871.707697538159;4912.066707325596;4655.9301610475195;4691.343211950398;4702.7883745230865;4702.988857395676;4709.81160753566;4658.114958157939;4659.627229821674;4685.672002959896;4688.531146885284;4752.144613969519;4552.248878935071;4586.770661466847;4612.469565999953;4627.46784119817;4677.321788340603;4712.882177945578;4758.64310176745;4777.784999674954;4780.426348838162;4782.210935195793;4683.203855344532;4692.48382677912;4694.671373003994;4694.906101878011;4737.194676905004 02:38:33 INFO - PROCESS | 14006 | |1;ext.html;574.4255744255744;591.28749856423;602.6771237134489;608.1182285685757;612.8161551534539;38862.94781678382;40835.18329633406;40839.18321633565;44562.554374456246;44619.77690111545;40315;40901.38647920276;40963.59036409635;41037.7948110259;41040.58959410405;7753.61231938405;7971.561564113971;7972.601369931509;7977.401694872879;7978.2420670036545;7770.689172433096;7866.881996770053;7869.881951770728;7870.803229919241;7873.133955264916;7848.175941526115;7910.327622152124;7915.1689072647405;7918.089419716749;7920.891075249469;7825.960870195641;7862.76411707644;7879.487833290817;7881.09367422748;7881.921180788233;7767.883481747778;7825.413094017971;7830;7861.96069019657;7865.685372585147;37657.435138472945;38201.808990954865;38209.23581528381;38243.23513529714;38305.425418618746;2630.395009147888;2804.4951908656435;2842.0905310300714;2962.318666706648;3023.4557779599663;29677.554836677467;29754;29875.103746887627;29968;30927.845360773277;3437.071990562559;3439.4840773883866;3448.2758620689433;3473.218525831693;3495.5106285120105;259593;260395;260481;261272;261863;45928.77035614801;46289;46502;46549.53450465452;46659;45739;54185.1872221917;55189.44810551924;55435.445645543834;61981.690091550154;14000.229987350793;14087.084339517898;14091.365888534836;14154.575362739135;14162.858371416154;9348.065193480597;11227.438628068563;11374.374409407563;11374.829377559343;11404;15858.286377113058;16180.67638647244;16399.672006559802;16801;16831.74752378715;6113.266408031065;6262.624242545462;6311.715972781236;6419.903701444482;6526.608403495806;784.7998760316083;798.7963069417261;931.2968708624945;1034.6999370182564;1056.102313033915;27600.585991210148;28527.144185674464;28617.856910715313;28683;29012.85493572561;949.6296444386695;959.8752162218867;988.1600639456404;1006.8288390973552;1008.7226012846526;14808;15094.320755566026;15180.772288415683;15228.162451065298;15233.542993710207;362412;366326;366840;366919;366957;48674.26988595174;49547.25679114816;49585.75207123941;49637;49820.750896245285;1057.724991502215;1119.4067144413636;1154.6593754842343;1181.1613754234418;1198.6224339333082;28188.295292617848;29011;29197.270068248465;29974.70025299719;29983.250418739706;41659;41941.161176776906;42302;42353.36469952892;42377.36433953555;302030;304836;305007;305131;305655;31295.37409251848;35445;36453.63546364608;36823.815880920425;39423.802880985415;41203;41990.37014444847;42160.1567968645;42707.14585708206;42844.78577607092;35707.82146089357;36128.4580731284;36741.816290918374;36795.44806827953;37057.81471092627;36141.63858361488;36198;36291.274174515835;36304;36624.81687591651;31429.52855707212;31930.84034579905;35206.64793352136;35344.46983295201;35731.642683573875;30772.38455230838;32228.35543289074;32783.67216327806;32810.50784238191;32814.17964550905;24807.379815504755;25164;25183.74816251814;25283.028290344915;25685.743142568335 02:38:33 INFO - PROCESS | 14006 | |2;jquery.html;352.73368606701933;369.136221242293;373.26280595823243;375.1783593929296;386.44352132928583;12905.935470322647;16327.918360408195;16639.50081497554;16917.154142292868;17949.7307540387;16365.181740912967;16998.40505582305;17398.82601173988;17601.64796704065;17813.7327940081;4958.628102892289;5212.139996900526;5537.307836520435;5553.972230138844;5590.524805391527;3421.4183588789965;5010.473900240477;5329.440408757064;5344.22508736233;5449.618526703132;5365.248865158881;5369.167778994262;5385.78456861727;5388.892222155555;5393.460653934614;5281.128613778722;5386.1920711893135;5574.219609254707;5574.916376254359;5663.433656634304;3318.1372843060735;5046.293518907356;5353.7590808413715;5368.946310536923;5446.2375267462585;12018.51925922962;12159;12248.142630015902;13845.723085538333;20991.685124723143;1957.862949593529;1998.6502362086576;2000.6598878190744;2098.646373089349;2192.47380628648;8982.10178982103;9226.723198304062;12879.613611591667;13307.667308317272;13558.457661693521;1709.1283445442914;1731.8787684862066;1767.1605987156127;1797.2002458905793;1800.734038156047;67454.66272668606;68043.65978170077;69510.30489695088;69980.3001969979;71831;8812.95593522041;9046.728598142066;9504.524773761284;9664.468454234944;10189.847152292721;13217.14088584239;13536.323183840768;13580.38888250031;13588.728225435436;13590.796138057936;7054.6825392857445;7167.4266058715175;7176.138863336433;7241.058662373963;7304.890426643605;6798.252192258848;6825.317468253234;6853;6933.1333583302085;6958.965205173941;4218.472690913636;4257.638100761408;4287.978560107242;4292.484901811803;4313.468718604913;1779.6084861330487;1794.9012804295628;1831.835134837871;1834.8073452287585;1860.8883466992024;818.6888982186731;834.6953362022819;861.1517655109712;866.7269810009826;949.4682977532603;16675.416360427327;17169.055701936515;17226.827731722773;17586.472405827844;17620.559486012953;834.1408349400127;839.6011894350135;848.8769128476337;861.4788053227833;896.7220161749748;9254.565542340948;9805.362651427777;9853.02939412106;9856.112949834549;9916.553755081039;375662;377526;377617;384871;391896;87486;89221.55389223012;91499;92867.53566232126;93458.53270733602;885.274075258282;888.693400776731;930.437085563238;930.5300823084299;932.0167223579053;15804.920975395049;16016.679666406373;16134.112623805804;16162;16164.515064548083;29351;33959;35079;37988;38698.80650596729;47086.29370559376;48392.27411588899;55844;59490.70254648699;60024.69987650034;7352.338289553966;7378.815529611803;7403.370713489198;7753.651085701044;7873.488223265698;10820.4048777318;11653.825192622287;11850.170488065753;11948.34284114382;12000.118989776905;9775;10002.24983126254;10069.395836249849;10337;10374.36040933818;9127;9200.539973001458;9299.349045566745;10061.144802691853;10606.257561970588;9619.903800961902;9935;10125.493725313852;10131.088202061555;10217.489125543842;7590.582517961565;7614.619269036637;7631.923680763121;7657.272559106876;7843.56860372685;9254.676086336945;9422.057794220524;9441.244700423813;9542.664027036082;9626.748522692005 02:38:33 INFO - PROCESS | 14006 | |3;mootools.html;1366.323669783457;1408.3732738931176;1484.3172140815225;1646.6871294454045;1695.8388953049464;7002.929970700291;7397.445191610637;7446.515976461526;7446.590437525941;7460.701571937123;6308.873822523547;6846.452283817295;7134.5719256844495;7158;7325.194228634846;2046.5906818636295;2120.766715661276;2121.6393213153724;2123.1189056541516;2125.6492678707996;2097.81119699227;2110.4090854560673;2140.1118535807623;2140.336495686342;2142.4215461825297;1856.5173055005662;2055.6094342074957;2113.746350437942;2117.036748279537;2141.2612648636195;2097.3603051069417;2142.0467891788085;2158.9999999999923;2161.5784921940226;2165.653495440722;2143.5605700831293;2147.098218748114;2149.376680762577;2150.3978885911815;2154.9353519394444;7311.232320606313;7411.740589079411;7415.777526674208;7419.554826710415;7420.703171873119;4157.875263742093;4259.680523960716;4262.87211383659;4274.764887931163;4282.036541778106;2633.855137967411;2750.4636595863813;2757.765589924859;2758.931026724348;2766.39139389336;878.7934835313696;896.9775755606097;912.8174365127002;915.7802127489422;927.2813569483636;9799.706008819676;10021.198304135653;10097.646582369582;10101.848472272923;10113;3891.7275790694944;3994.72036957416;4128.339465685536;4133.297339452301;4164.562720914321;8654.567271636393;8706.782330441663;8713.215810577078;8719.65121395137;8720.781980450412;4374.825006999748;4418.138462999685;4424.60178583929;4429.202743506135;4430.712003719748;3913.882583522499;3952.446657467957;3996.4005399190355;4002.3596224603925;4039.8586049488126;3396.847141878621;3476.3916314644835;3496.30073985204;3540.7698499597445;3546.2730140321173;1063.5852017713098;1089.3790539392628;1146.7247860513583;1155.4338374196584;1163.976720465586;637.6620391192675;647.3397134922353;647.9254885688111;695.7460526907744;720.8558288342352;4977.65156439053;5021.468452122138;5024.397072351268;5066.08810414129;5067.873303167376;793.6904607203195;835.4736515994884;846.8052347959881;846.8306338732154;852.3394369363792;3185.1240908749814;3203.3112880730287;3213.7107660310685;3218.1471909943884;3218.468952622838;8872.334574906909;9137.04061073591;9221.677241296522;9240.3993740408;9250.306227033;8873.29013678904;8936.821263574691;9094.909050909406;9113.407628504126;9132.771680707903;6749.190097188369;6823.1812182538415;6827.795166145023;6842.178938527309;6883.346082122191;4713.104510143062;4752.619790416689;4793.880152996203;4814.927776083291;4873.512648735098;8102.189781021851;8327.875081873655;8373.748787536384;8401.70594029206;8406.705765298186;8537.018242902146;8630.093840146694;8691.86962195555;8846.380753347205;8877.73366798997;6824.829379265558;6915.101036865175;6938.722451102101;6969.9303006969285;6972.058772065909;6709.027191057172;6778.8983165251575;6780.321967803377;6895.448364130757;6954.269801670954;4499.662525310549;6051.5461340400525;6192.59748116389;6257.2491301044165;6466.385693359123;6134.355892631388;6155.969220153871;6182.505399568114;6199.752009919553;6342.904856427065;5501.14732216507;6061.515078793598;6074.908876366946;6117.938820611915;6135.110408990582;4195.559466255999;4239.491261048694;4241.427407299975;4272.252355837654;4295.763732994716;4236.131593023484;4316.115196384796;4406.911861762811;4423.402840616604;4440.22296098188 02:38:33 INFO - PROCESS | 14006 | |4;prototype.html;293.6549554273728;301.3490859742955;302.43595694030626;305.2369077306733;305.5676218151316;4732.195526760451;4754.144254034272;4757.119932812432;4765.666403351766;4774.283857421388;4631.8147274109;4649.488556258817;4710.623150147989;4711.882202944919;4727.369057675105;3510.1217002058324;3569.5538057742783;3628.9677780443035;3677.7679477374977;3731.1791405890795;3680.4479328100733;3687.8340474678703;3705.94441083384;3715.136258291374;3716.9442458363146;3507.8421471033867;3686.3548878946212;3687.2809802088605;3690.782041926171;3696.6488183622646;3501.9474707879403;3614.2590768892314;3617.3488772021024;3625.365561026823;3688.649578290085;3279.770416070876;3280.655531169217;3282.983585082083;3286.1620286826947;3291.8683252669866;4544.568266014723;4549.545045495457;4559.452865656142;4569.1547063793305;4575.290829921368;4106.568810274908;4169.97915010423;4192.664586833076;4194.580541945811;4206.875527858412;4799.408319507462;4814.820369009615;4825.300331451955;4841.588464980481;4849.127157111719;3564.681068004829;3565.4295312750096;3576.660217279354;3582.1223800168864;3583.569971603424;4916.852494425173;5073.34046573943;5082.466341034212;5091.338126043628;5109.704240764686;3671.1005803578296;3675.852965881335;3682.963170368316;3684.4473329000866;3697.352963231424;3728.217074414403;3734.589195188527;3736.9065773355883;3737.850485980585;3741.4761933329355;4179.582041795796;4188.979055104766;4195.643370313557;4205.831766729297;4208.516020657602;4732.73969931657;4845.733484658307;4854.713500922258;4882.584980276645;4897.583705385082;1278.5525066226746;1286.8584455709865;1292.8383952006;1293.340396397825;1297.3383574377135;820.7455688736392;842.309306368784;852.5694524265207;854.4875570240639;859.4757198109148;4009.538903026131;4192.601702838226;4288.978555107205;4382.8904277392685;4397.8240870364825;5038.823641172615;5041.655630132006;5046.823361182414;5050.343455350854;5073.594112470993;4391.604755572014;4401.471823381215;4412.492563355191;4422.646188304928;4430.712003719748;2560.974390256111;2639.142278759411;2679.6601699150424;2703.5809449535354;2706.5384692265957;4831.637627177975;4832.565069143794;4836.250381190851;4851.830185943475;4856.708597484092;5155.329807125125;5175.689458632494;5183.896322073613;5190.09173394662;5199.246109314204;4686.507916668769;4769.379980602569;4823.397075365579;4830.541098595628;4833.371661684029;5059.519345662156;5062.67092638992;5071.974640126776;5075.847724568269;5082.796688132434;4932.53140951609;4940.827071052639;4942.481039490802;4987.576056035277;4991.800327986985;4671.18254305502;4815.662903596854;4829.27560865873;4830.898559126791;4846.127697014571;3655.762375445694;3655.7989310588173;3664.1389273521236;3682.1899182179877;3684.871029513954;4988.575971042502;4999.600031997359;5013.924791128063;5037.244413338029;5037.622178336566;4665.5101214372;4861.343718598086;4867.123917694849;4867.70793752376;4900.901981960412;4867.14824905633;4877.658563900635;4882.975585122052;4889.90220195587;4890.2909078184175;4787.904241915212;4795.784189711401;4821.662483626113;4827.889585395449;4833;4732.219183834629;4894.143524883202;4902.779374928065;4904.435989861069;4915.729634870117;4793.736344501086;4797.304390863375;4799.712017278975;4810.735409552508;4825.479973808239 02:38:33 INFO - PROCESS | 14006 | |5;yui.html;597.2057163971917;608.6743592178185;625.0468036244729;652.634524666187;683.0744341417379;11789.941050294747;12606.495740170381;12625.179363341387;12636.747265054704;12639.304838233893;12437.191582547128;12757.681057973532;12882.806757898616;12906.741865162714;12934.805977910339;623.0840664223584;741.5958302725;744.1219361153836;755.1881727143316;761.973330933416;762.2491845532146;770.9575973321465;774.3340726974798;774.6514068669094;776.3905334312566;825.8513467575834;829.7178959153887;830.7258604660477;831.0484495252932;831.8211584509329;641.1792905081503;761.0676920772065;786.4062632712323;789.2935822438942;793.0443815202667;580.3007376111775;583.4078410413434;584.1121495327079;585.023011570678;585.2304219950751;12348.320842353667;12385.256884586863;12400.751984960341;12411.379431028412;12414.131010829245;11705.239159454608;11756;11848;12124.27254364741;12335.5065797368;11393.715157121138;11406.258593191416;11450.885491145065;11701.941490292495;11997.580084696994;3878.786666733357;3911.5110611173604;3917.745346552465;3934.1344904121047;4041.7777022263763;58791.70604146952;60401.395986040014;61471.69264153695;62150.68924655393;62314.37685623131;8521.53131577769;8818.29453643707;8822.426542274732;8869.379143459895;8892;14992.175430351217;15011.099334039774;15036.323365448581;15380.846191538165;15714.371425142866;6153.323134455206;6294.716737746812;6298.622082675054;6415.1981002374705;6435;3545.0782796472586;3571.62497937718;3605.188832512664;3608.6752192302292;3638.43604241343;2609.165067178523;2677.8527181004843;2691.2733561938167;2697.905573304925;2701.054630879177;381.28128477818956;455.1602293767993;477.53440395614;479.47258016182616;522.1775703267369;533.2055237695805;546.2598179466845;562.8198976327618;564.9548036157098;565.9320881494247;8188.181181881764;8380.58097095155;8443;8448.930012147064;8907.421017633833;433.9739615623073;525.6793356052805;526.2001757328915;531.5548968753859;531.9520544527275;3901.141748815256;3915.530136383652;3966.960330396717;3990.3415936370175;4028.959710402917;62065;81147.5942620295;108240;113481;113638;53147;68921.3107868915;78129.60935195288;80605;83518.58240708758;47075.76462117668;55138.724306379016;70775.2922470779;74673.62663186649;75589.24410755932;8771.561421929006;8880.73357799267;8891.422057566237;9019.729408117766;9092.772680683036;39188.41217381685;41586.58413415827;42178;42455.7877210612;43174;61966;65319;65604.67197664172;65647;65848.34151658422;8995.91004089977;9021.368504204906;9178.908210917805;10802;11232.213745038096;10587.100096491577;10690.091342235997;10877.075448586958;10993.120550356112;11135.10919126484;10439.53022114022;10490.370577765358;10509.106725928381;10634.787304254027;10934.45327733626;10102;10709.678709638723;12540.122191446511;12763.425645845773;12959.740805184032;11246.437678115897;12043.337616431181;12141.150119491904;12155.817662735242;12752.4261408235;10070.748231294276;10657.094146997591;10772.138228941823;11056.778864422828;11183.217174797686;10286.794264114826;10902.127829773757;10986.340819550853;11072;11089.722756931142 02:38:33 INFO - PROCESS | 14006 | __end_tp_report 02:38:33 INFO - PROCESS | 14006 | __start_cc_report 02:38:33 INFO - PROCESS | 14006 | _x_x_mozilla_cycle_collect,960 02:38:33 INFO - PROCESS | 14006 | __end_cc_report 02:38:33 INFO - PROCESS | 14006 | __startTimestamp1468229913672__endTimestamp 02:38:33 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | ------- Summary: start ------- 02:38:33 INFO - PROCESS | 14006 | Number of tests: 6 02:38:33 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | [#0] dojo.html Cycles:165 Average:4492.49 Median:4610.22 stddev:468.13 (10.2%) stddev-sans-first:443.94 02:38:33 INFO - PROCESS | 14006 | Values: 2545.1 2547.2 2579.4 2581.3 2588.3 4477.7 4550.5 4550.6 4560.1 4571.7 4482.3 4523.6 4525.8 4548.2 4553.8 3925.0 4105.7 4159.8 4169.4 4273.4 4193.4 4243.7 4253.6 4278.8 4285.9 4102.1 4126.8 4130.0 4137.6 4142.3 4148.4 4170.5 4214.7 4217.7 4218.5 4189.6 4191.8 4197.7 4213.8 4234.4 4389.8 4526.5 4581.1 4584.4 4626.4 4923.1 4933.9 4944.2 4944.6 4944.9 4789.4 4912.3 4935.0 4951.8 4962.9 4557.6 4605.6 4607.7 4610.2 4611.9 4994.7 5073.5 5076.0 5077.6 5086.9 4706.1 4794.1 4849.9 4877.4 4880.0 4915.2 4918.7 4929.5 4933.9 4936.0 4821.5 4834.0 4836.2 4837.8 4882.7 4721.6 4738.5 4797.6 4818.6 4819.7 4115.5 4118.3 4118.7 4142.9 4155.0 3616.3 3620.2 3625.2 3635.8 3660.0 4148.9 4164.7 4169.5 4184.2 4250.4 4740.2 4745.9 4753.7 4804.4 4816.8 4152.3 4157.8 4166.5 4171.8 4206.0 4278.8 4329.2 4329.3 4367.3 4367.9 4534.5 4559.3 4562.8 4566.8 4593.0 4813.1 4819.9 4822.8 4828.2 4874.5 4502.4 4580.7 4606.9 4622.9 4627.5 4771.7 4773.9 4774.8 4783.9 4808.3 4752.7 4837.3 4856.4 4871.7 4912.1 4655.9 4691.3 4702.8 4703.0 4709.8 4658.1 4659.6 4685.7 4688.5 4752.1 4552.2 4586.8 4612.5 4627.5 4677.3 4712.9 4758.6 4777.8 4780.4 4782.2 4683.2 4692.5 4694.7 4694.9 4737.2 02:38:33 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | [#1] ext.html Cycles:180 Average:46857.40 Median:366879.50 stddev:82240.27 (22.4%) stddev-sans-first:82397.55 02:38:33 INFO - PROCESS | 14006 | Values: 574.4 591.3 602.7 608.1 612.8 38862.9 40835.2 40839.2 44562.6 44619.8 40315.0 40901.4 40963.6 41037.8 41040.6 7753.6 7971.6 7972.6 7977.4 7978.2 7770.7 7866.9 7869.9 7870.8 7873.1 7848.2 7910.3 7915.2 7918.1 7920.9 7826.0 7862.8 7879.5 7881.1 7881.9 7767.9 7825.4 7830.0 7862.0 7865.7 37657.4 38201.8 38209.2 38243.2 38305.4 2630.4 2804.5 2842.1 2962.3 3023.5 29677.6 29754.0 29875.1 29968.0 30927.8 3437.1 3439.5 3448.3 3473.2 3495.5 259593.0 260395.0 260481.0 261272.0 261863.0 45928.8 46289.0 46502.0 46549.5 46659.0 45739.0 54185.2 55189.4 55435.4 61981.7 14000.2 14087.1 14091.4 14154.6 14162.9 9348.1 11227.4 11374.4 11374.8 11404.0 15858.3 16180.7 16399.7 16801.0 16831.7 6113.3 6262.6 6311.7 6419.9 6526.6 784.8 798.8 931.3 1034.7 1056.1 27600.6 28527.1 28617.9 28683.0 29012.9 949.6 959.9 988.2 1006.8 1008.7 14808.0 15094.3 15180.8 15228.2 15233.5 362412.0 366326.0 366840.0 366919.0 366957.0 48674.3 49547.3 49585.8 49637.0 49820.8 1057.7 1119.4 1154.7 1181.2 1198.6 28188.3 29011.0 29197.3 29974.7 29983.3 41659.0 41941.2 42302.0 42353.4 42377.4 302030.0 304836.0 305007.0 305131.0 305655.0 31295.4 35445.0 36453.6 36823.8 39423.8 41203.0 41990.4 42160.2 42707.1 42844.8 35707.8 36128.5 36741.8 36795.4 37057.8 36141.6 36198.0 36291.3 36304.0 36624.8 31429.5 31930.8 35206.6 35344.5 35731.6 30772.4 32228.4 32783.7 32810.5 32814.2 24807.4 25164.0 25183.7 25283.0 25685.7 02:38:33 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | [#2] jquery.html Cycles:180 Average:24314.95 Median:5246.63 stddev:63495.09 (1210.2%) stddev-sans-first:63647.72 02:38:33 INFO - PROCESS | 14006 | Values: 352.7 369.1 373.3 375.2 386.4 12905.9 16327.9 16639.5 16917.2 17949.7 16365.2 16998.4 17398.8 17601.6 17813.7 4958.6 5212.1 5537.3 5554.0 5590.5 3421.4 5010.5 5329.4 5344.2 5449.6 5365.2 5369.2 5385.8 5388.9 5393.5 5281.1 5386.2 5574.2 5574.9 5663.4 3318.1 5046.3 5353.8 5368.9 5446.2 12018.5 12159.0 12248.1 13845.7 20991.7 1957.9 1998.7 2000.7 2098.6 2192.5 8982.1 9226.7 12879.6 13307.7 13558.5 1709.1 1731.9 1767.2 1797.2 1800.7 67454.7 68043.7 69510.3 69980.3 71831.0 8813.0 9046.7 9504.5 9664.5 10189.8 13217.1 13536.3 13580.4 13588.7 13590.8 7054.7 7167.4 7176.1 7241.1 7304.9 6798.3 6825.3 6853.0 6933.1 6959.0 4218.5 4257.6 4288.0 4292.5 4313.5 1779.6 1794.9 1831.8 1834.8 1860.9 818.7 834.7 861.2 866.7 949.5 16675.4 17169.1 17226.8 17586.5 17620.6 834.1 839.6 848.9 861.5 896.7 9254.6 9805.4 9853.0 9856.1 9916.6 375662.0 377526.0 377617.0 384871.0 391896.0 87486.0 89221.6 91499.0 92867.5 93458.5 885.3 888.7 930.4 930.5 932.0 15804.9 16016.7 16134.1 16162.0 16164.5 29351.0 33959.0 35079.0 37988.0 38698.8 47086.3 48392.3 55844.0 59490.7 60024.7 7352.3 7378.8 7403.4 7753.7 7873.5 10820.4 11653.8 11850.2 11948.3 12000.1 9775.0 10002.2 10069.4 10337.0 10374.4 9127.0 9200.5 9299.3 10061.1 10606.3 9619.9 9935.0 10125.5 10131.1 10217.5 7590.6 7614.6 7631.9 7657.3 7843.6 9254.7 9422.1 9441.2 9542.7 9626.7 02:38:33 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | [#3] mootools.html Cycles:180 Average:4847.39 Median:4999.56 stddev:2705.04 (54.1%) stddev-sans-first:2699.98 02:38:33 INFO - PROCESS | 14006 | Values: 1366.3 1408.4 1484.3 1646.7 1695.8 7002.9 7397.4 7446.5 7446.6 7460.7 6308.9 6846.5 7134.6 7158.0 7325.2 2046.6 2120.8 2121.6 2123.1 2125.6 2097.8 2110.4 2140.1 2140.3 2142.4 1856.5 2055.6 2113.7 2117.0 2141.3 2097.4 2142.0 2159.0 2161.6 2165.7 2143.6 2147.1 2149.4 2150.4 2154.9 7311.2 7411.7 7415.8 7419.6 7420.7 4157.9 4259.7 4262.9 4274.8 4282.0 2633.9 2750.5 2757.8 2758.9 2766.4 878.8 897.0 912.8 915.8 927.3 9799.7 10021.2 10097.6 10101.8 10113.0 3891.7 3994.7 4128.3 4133.3 4164.6 8654.6 8706.8 8713.2 8719.7 8720.8 4374.8 4418.1 4424.6 4429.2 4430.7 3913.9 3952.4 3996.4 4002.4 4039.9 3396.8 3476.4 3496.3 3540.8 3546.3 1063.6 1089.4 1146.7 1155.4 1164.0 637.7 647.3 647.9 695.7 720.9 4977.7 5021.5 5024.4 5066.1 5067.9 793.7 835.5 846.8 846.8 852.3 3185.1 3203.3 3213.7 3218.1 3218.5 8872.3 9137.0 9221.7 9240.4 9250.3 8873.3 8936.8 9094.9 9113.4 9132.8 6749.2 6823.2 6827.8 6842.2 6883.3 4713.1 4752.6 4793.9 4814.9 4873.5 8102.2 8327.9 8373.7 8401.7 8406.7 8537.0 8630.1 8691.9 8846.4 8877.7 6824.8 6915.1 6938.7 6969.9 6972.1 6709.0 6778.9 6780.3 6895.4 6954.3 4499.7 6051.5 6192.6 6257.2 6466.4 6134.4 6156.0 6182.5 6199.8 6342.9 5501.1 6061.5 6074.9 6117.9 6135.1 4195.6 4239.5 4241.4 4272.3 4295.8 4236.1 4316.1 4406.9 4423.4 4440.2 02:38:33 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | [#4] prototype.html Cycles:180 Average:4091.63 Median:4711.25 stddev:1173.31 (24.9%) stddev-sans-first:1141.44 02:38:33 INFO - PROCESS | 14006 | Values: 293.7 301.3 302.4 305.2 305.6 4732.2 4754.1 4757.1 4765.7 4774.3 4631.8 4649.5 4710.6 4711.9 4727.4 3510.1 3569.6 3629.0 3677.8 3731.2 3680.4 3687.8 3705.9 3715.1 3716.9 3507.8 3686.4 3687.3 3690.8 3696.6 3501.9 3614.3 3617.3 3625.4 3688.6 3279.8 3280.7 3283.0 3286.2 3291.9 4544.6 4549.5 4559.5 4569.2 4575.3 4106.6 4170.0 4192.7 4194.6 4206.9 4799.4 4814.8 4825.3 4841.6 4849.1 3564.7 3565.4 3576.7 3582.1 3583.6 4916.9 5073.3 5082.5 5091.3 5109.7 3671.1 3675.9 3683.0 3684.4 3697.4 3728.2 3734.6 3736.9 3737.9 3741.5 4179.6 4189.0 4195.6 4205.8 4208.5 4732.7 4845.7 4854.7 4882.6 4897.6 1278.6 1286.9 1292.8 1293.3 1297.3 820.7 842.3 852.6 854.5 859.5 4009.5 4192.6 4289.0 4382.9 4397.8 5038.8 5041.7 5046.8 5050.3 5073.6 4391.6 4401.5 4412.5 4422.6 4430.7 2561.0 2639.1 2679.7 2703.6 2706.5 4831.6 4832.6 4836.3 4851.8 4856.7 5155.3 5175.7 5183.9 5190.1 5199.2 4686.5 4769.4 4823.4 4830.5 4833.4 5059.5 5062.7 5072.0 5075.8 5082.8 4932.5 4940.8 4942.5 4987.6 4991.8 4671.2 4815.7 4829.3 4830.9 4846.1 3655.8 3655.8 3664.1 3682.2 3684.9 4988.6 4999.6 5013.9 5037.2 5037.6 4665.5 4861.3 4867.1 4867.7 4900.9 4867.1 4877.7 4883.0 4889.9 4890.3 4787.9 4795.8 4821.7 4827.9 4833.0 4732.2 4894.1 4902.8 4904.4 4915.7 4793.7 4797.3 4799.7 4810.7 4825.5 02:38:33 INFO - PROCESS | 14006 | 02:38:33 INFO - PROCESS | 14006 | [#5] yui.html Cycles:180 Average:16848.85 Median:21803.99 stddev:24187.43 (110.9%) stddev-sans-first:24224.50 02:38:33 INFO - PROCESS | 14006 | Values: 597.2 608.7 625.0 652.6 683.1 11789.9 12606.5 12625.2 12636.7 12639.3 12437.2 12757.7 12882.8 12906.7 12934.8 623.1 741.6 744.1 755.2 762.0 762.2 771.0 774.3 774.7 776.4 825.9 829.7 830.7 831.0 831.8 641.2 761.1 786.4 789.3 793.0 580.3 583.4 584.1 585.0 585.2 12348.3 12385.3 12400.8 12411.4 12414.1 11705.2 11756.0 11848.0 12124.3 12335.5 11393.7 11406.3 11450.9 11701.9 11997.6 3878.8 3911.5 3917.7 3934.1 4041.8 58791.7 60401.4 61471.7 62150.7 62314.4 8521.5 8818.3 8822.4 8869.4 8892.0 14992.2 15011.1 15036.3 15380.8 15714.4 6153.3 6294.7 6298.6 6415.2 6435.0 3545.1 3571.6 3605.2 3608.7 3638.4 2609.2 2677.9 2691.3 2697.9 2701.1 381.3 455.2 477.5 479.5 522.2 533.2 546.3 562.8 565.0 565.9 8188.2 8380.6 8443.0 8448.9 8907.4 434.0 525.7 526.2 531.6 532.0 3901.1 3915.5 3967.0 3990.3 4029.0 62065.0 81147.6 108240.0 113481.0 113638.0 53147.0 68921.3 78129.6 80605.0 83518.6 47075.8 55138.7 70775.3 74673.6 75589.2 8771.6 8880.7 8891.4 9019.7 9092.8 39188.4 41586.6 42178.0 42455.8 43174.0 61966.0 65319.0 65604.7 65647.0 65848.3 8995.9 9021.4 9178.9 10802.0 11232.2 10587.1 10690.1 10877.1 10993.1 11135.1 10439.5 10490.4 10509.1 10634.8 10934.5 10102.0 10709.7 12540.1 12763.4 12959.7 11246.4 12043.3 12141.2 12155.8 12752.4 10070.7 10657.1 10772.1 11056.8 11183.2 10286.8 10902.1 10986.3 11072.0 11089.7 02:38:33 INFO - PROCESS | 14006 | -------- Summary: end -------- 02:38:33 INFO - PROCESS | 14006 | 02:38:34 INFO - TEST-INFO | 14006: exit 0 02:38:34 INFO - TEST-OK | dromaeo_css | took 1118950ms 02:38:34 INFO - TEST-START | kraken 02:38:34 INFO - operating with platform_type : linux_ 02:38:34 INFO - Initialising browser for kraken test... 02:38:34 INFO - TEST-INFO | started process 14192 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpICvGrF/profile http://localhost:52677/getInfo.html) 02:38:38 INFO - PROCESS | 14192 | __metrics Screen width/height:1600/1200 02:38:38 INFO - PROCESS | 14192 | colorDepth:24 02:38:38 INFO - PROCESS | 14192 | Browser inner width/height: 1024/697 02:38:38 INFO - PROCESS | 14192 | __metrics 02:38:39 INFO - PROCESS | 14192 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 02:38:39 INFO - PROCESS | 14192 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 02:38:40 INFO - TEST-INFO | 14192: exit 0 02:38:40 INFO - Browser initialized. 02:38:40 INFO - Running cycle 1/1 for kraken test... 02:38:40 INFO - TEST-INFO | started process 14276 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpICvGrF/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:38:52 INFO - PROCESS | 14276 | RSS: Main: 158527488 02:38:52 INFO - PROCESS | 14276 | 02:38:55 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52677/tests/kraken/driver.html?testName=audio-beat-detection) 02:38:56 INFO - PROCESS | 14276 | RSS: Main: 216469504 02:38:56 INFO - PROCESS | 14276 | 02:38:58 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52677/tests/kraken/driver.html?testName=audio-dft) 02:38:59 INFO - PROCESS | 14276 | RSS: Main: 203927552 02:38:59 INFO - PROCESS | 14276 | 02:39:02 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52677/tests/kraken/driver.html?testName=audio-fft) 02:39:03 INFO - PROCESS | 14276 | RSS: Main: 271921152 02:39:03 INFO - PROCESS | 14276 | 02:39:05 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52677/tests/kraken/driver.html?testName=audio-oscillator) 02:39:06 INFO - PROCESS | 14276 | RSS: Main: 181653504 02:39:06 INFO - PROCESS | 14276 | 02:39:08 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52677/tests/kraken/driver.html?testName=imaging-gaussian-blur) 02:39:09 INFO - PROCESS | 14276 | RSS: Main: 185839616 02:39:09 INFO - PROCESS | 14276 | 02:39:12 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52677/tests/kraken/driver.html?testName=imaging-darkroom) 02:39:12 INFO - PROCESS | 14276 | RSS: Main: 222248960 02:39:12 INFO - PROCESS | 14276 | 02:39:16 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52677/tests/kraken/driver.html?testName=imaging-desaturate) 02:39:17 INFO - PROCESS | 14276 | RSS: Main: 217956352 02:39:17 INFO - PROCESS | 14276 | 02:39:19 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52677/tests/kraken/driver.html?testName=json-parse-financial) 02:39:20 INFO - PROCESS | 14276 | RSS: Main: 220483584 02:39:20 INFO - PROCESS | 14276 | 02:39:22 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52677/tests/kraken/driver.html?testName=json-stringify-tinderbox) 02:39:22 INFO - PROCESS | 14276 | RSS: Main: 206196736 02:39:22 INFO - PROCESS | 14276 | 02:39:24 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52677/tests/kraken/driver.html?testName=stanford-crypto-aes) 02:39:25 INFO - PROCESS | 14276 | RSS: Main: 212525056 02:39:25 INFO - PROCESS | 14276 | 02:39:27 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52677/tests/kraken/driver.html?testName=stanford-crypto-ccm) 02:39:28 INFO - PROCESS | 14276 | RSS: Main: 211009536 02:39:28 INFO - PROCESS | 14276 | 02:39:30 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52677/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 02:39:31 INFO - PROCESS | 14276 | RSS: Main: 226140160 02:39:31 INFO - PROCESS | 14276 | 02:39:34 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52677/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 02:39:35 INFO - PROCESS | 14276 | RSS: Main: 226066432 02:39:35 INFO - PROCESS | 14276 | 02:39:36 INFO - PROCESS | 14276 | Cycle 1(1): loaded http://localhost:52677/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52677/tests/kraken/driver.html?testName=ai-astar) 02:39:37 INFO - PROCESS | 14276 | RSS: Main: 267505664 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | __start_tp_report 02:39:37 INFO - PROCESS | 14276 | _x_x_mozilla_page_load 02:39:37 INFO - PROCESS | 14276 | _x_x_mozilla_page_load_details 02:39:37 INFO - PROCESS | 14276 | |i|pagename|runs| 02:39:37 INFO - PROCESS | 14276 | |0;ai-astar;103;114;114;114;113;113;113;114;113;113 02:39:37 INFO - PROCESS | 14276 | |1;audio-beat-detection;155;125;125;180;123;123;144;121;172;121 02:39:37 INFO - PROCESS | 14276 | |2;audio-dft;161;161;160;160;162;162;161;161;163;161 02:39:37 INFO - PROCESS | 14276 | |3;audio-fft;75;75;76;114;76;77;75;76;106;76 02:39:37 INFO - PROCESS | 14276 | |4;audio-oscillator;85;92;116;85;86;85;114;84;85;128 02:39:37 INFO - PROCESS | 14276 | |5;imaging-gaussian-blur;117;117;118;117;118;117;117;117;118;118 02:39:37 INFO - PROCESS | 14276 | |6;imaging-darkroom;147;146;147;146;146;146;146;147;146;150 02:39:37 INFO - PROCESS | 14276 | |7;imaging-desaturate;95;95;95;94;95;95;95;95;95;95 02:39:37 INFO - PROCESS | 14276 | |8;json-parse-financial;65;63;62;63;63;64;63;63;63;63 02:39:37 INFO - PROCESS | 14276 | |9;json-stringify-tinderbox;65;65;65;65;65;64;64;65;66;65 02:39:37 INFO - PROCESS | 14276 | |10;stanford-crypto-aes;87;81;85;80;79;78;77;84;77;86 02:39:37 INFO - PROCESS | 14276 | |11;stanford-crypto-ccm;141;128;126;131;131;141;129;131;166;134 02:39:37 INFO - PROCESS | 14276 | |12;stanford-crypto-pbkdf2;166;169;167;166;168;166;166;164;166;165 02:39:37 INFO - PROCESS | 14276 | |13;stanford-crypto-sha256-iterative;68;68;67;66;70;70;67;67;65;67 02:39:37 INFO - PROCESS | 14276 | __end_tp_report 02:39:37 INFO - PROCESS | 14276 | __start_cc_report 02:39:37 INFO - PROCESS | 14276 | _x_x_mozilla_cycle_collect,1892 02:39:37 INFO - PROCESS | 14276 | __end_cc_report 02:39:37 INFO - PROCESS | 14276 | __startTimestamp1468229977064__endTimestamp 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | ------- Summary: start ------- 02:39:37 INFO - PROCESS | 14276 | Number of tests: 14 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#0] ai-astar Cycles:10 Average:112.40 Median:113.50 stddev:3.34 (2.9%) stddev-sans-first:0.53 02:39:37 INFO - PROCESS | 14276 | Values: 103.0 114.0 114.0 114.0 113.0 113.0 113.0 114.0 113.0 113.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#1] audio-beat-detection Cycles:10 Average:138.90 Median:134.50 stddev:22.61 (16.8%) stddev-sans-first:23.22 02:39:37 INFO - PROCESS | 14276 | Values: 155.0 125.0 125.0 180.0 123.0 123.0 144.0 121.0 172.0 121.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#2] audio-dft Cycles:10 Average:161.20 Median:161.00 stddev:0.92 (0.6%) stddev-sans-first:0.97 02:39:37 INFO - PROCESS | 14276 | Values: 161.0 161.0 160.0 160.0 162.0 162.0 161.0 161.0 163.0 161.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#3] audio-fft Cycles:10 Average:82.60 Median:76.00 stddev:14.58 (19.2%) stddev-sans-first:15.20 02:39:37 INFO - PROCESS | 14276 | Values: 75.0 75.0 76.0 114.0 76.0 77.0 75.0 76.0 106.0 76.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#4] audio-oscillator Cycles:10 Average:96.00 Median:85.00 stddev:16.64 (19.6%) stddev-sans-first:17.17 02:39:37 INFO - PROCESS | 14276 | Values: 85.0 92.0 116.0 85.0 86.0 85.0 114.0 84.0 85.0 128.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#5] imaging-gaussian-blur Cycles:10 Average:117.40 Median:117.50 stddev:0.52 (0.4%) stddev-sans-first:0.53 02:39:37 INFO - PROCESS | 14276 | Values: 117.0 117.0 118.0 117.0 118.0 117.0 117.0 117.0 118.0 118.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#6] imaging-darkroom Cycles:10 Average:146.70 Median:146.50 stddev:1.25 (0.9%) stddev-sans-first:1.32 02:39:37 INFO - PROCESS | 14276 | Values: 147.0 146.0 147.0 146.0 146.0 146.0 146.0 147.0 146.0 150.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#7] imaging-desaturate Cycles:10 Average:94.90 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 02:39:37 INFO - PROCESS | 14276 | Values: 95.0 95.0 95.0 94.0 95.0 95.0 95.0 95.0 95.0 95.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#8] json-parse-financial Cycles:10 Average:63.20 Median:63.00 stddev:0.79 (1.3%) stddev-sans-first:0.50 02:39:37 INFO - PROCESS | 14276 | Values: 65.0 63.0 62.0 63.0 63.0 64.0 63.0 63.0 63.0 63.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#9] json-stringify-tinderbox Cycles:10 Average:64.90 Median:65.00 stddev:0.57 (0.9%) stddev-sans-first:0.60 02:39:37 INFO - PROCESS | 14276 | Values: 65.0 65.0 65.0 65.0 65.0 64.0 64.0 65.0 66.0 65.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#10] stanford-crypto-aes Cycles:10 Average:81.40 Median:82.50 stddev:3.81 (4.6%) stddev-sans-first:3.46 02:39:37 INFO - PROCESS | 14276 | Values: 87.0 81.0 85.0 80.0 79.0 78.0 77.0 84.0 77.0 86.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#11] stanford-crypto-ccm Cycles:10 Average:135.80 Median:132.50 stddev:11.75 (8.9%) stddev-sans-first:12.31 02:39:37 INFO - PROCESS | 14276 | Values: 141.0 128.0 126.0 131.0 131.0 141.0 129.0 131.0 166.0 134.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.30 Median:166.00 stddev:1.42 (0.9%) stddev-sans-first:1.50 02:39:37 INFO - PROCESS | 14276 | Values: 166.0 169.0 167.0 166.0 168.0 166.0 166.0 164.0 166.0 165.0 02:39:37 INFO - PROCESS | 14276 | 02:39:37 INFO - PROCESS | 14276 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.50 Median:67.50 stddev:1.58 (2.3%) stddev-sans-first:1.67 02:39:37 INFO - PROCESS | 14276 | Values: 68.0 68.0 67.0 66.0 70.0 70.0 67.0 67.0 65.0 67.0 02:39:37 INFO - PROCESS | 14276 | -------- Summary: end -------- 02:39:37 INFO - PROCESS | 14276 | 02:39:38 INFO - TEST-INFO | 14276: exit 0 02:39:38 INFO - TEST-OK | kraken | took 63729ms 02:39:38 INFO - SUITE-END | took 1182s 02:39:38 INFO - Completed test suite (00:19:42) 02:39:38 INFO - javascript benchmark 02:39:38 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2545.096490745785, 2547.2103647869176, 2579.4325248445334, 2581.3030481769924, 2588.2752829207816, 4477.664175186866, 4550.522195169509, 4550.590446859786, 4560.133574620824, 4571.657125715568, 4482.260427029544, 4523.570260825217, 4525.841595544157, 4548.181327361073, 4553.817847286105, 3925.0, 4105.671546276299, 4159.83360665573, 4169.3954376615375, 4273.423087883127, 4193.35003074524, 4243.72415792974, 4253.553376895427, 4278.764667943262, 4285.914281714364, 4102.118044620391, 4126.834926602933, 4129.988152902528, 4137.586241375869, 4142.2751018571935, 4148.43996060531, 4170.541240463546, 4214.704970652056, 4217.746935183899, 4218.472690913636, 4189.622933935961, 4191.7694526801015, 4197.727147735418, 4213.810378532973, 4234.386014027979, 4389.802458889358, 4526.524714904954, 4581.106684196583, 4584.449866016066, 4626.352310676474, 4923.08922849274, 4933.851984440473, 4944.184209605411, 4944.60443164546, 4944.8763780905765, 4789.449213340476, 4912.336834527328, 4934.975325123387, 4951.777170027357, 4962.900741985176, 4557.56703113207, 4605.562471565196, 4607.723536587815, 4610.216263235258, 4611.9077618447445, 4994.725290109006, 5073.543381095719, 5075.974620126875, 5077.568406685399, 5086.92369614456, 4706.129366067288, 4794.065157294364, 4849.933014736752, 4877.3903262092235, 4879.975600122048, 4915.16442204826, 4918.6556941014505, 4929.482404347564, 4933.876653083702, 4935.975320123376, 4821.4696383397795, 4834.0, 4836.202026665631, 4837.758112094381, 4882.658213925062, 4721.6458765592715, 4738.5261473853025, 4797.616190704735, 4818.614510839125, 4819.734914579732, 4115.54728979812, 4118.299889018874, 4118.732282401635, 4142.855000074983, 4155.002799328139, 3616.27674465108, 3620.167361506868, 3625.220577575834, 3635.818209089535, 3659.963400365962, 4148.896277593024, 4164.66682665386, 4169.520505141887, 4184.184084103571, 4250.383694364362, 4740.19416699162, 4745.905081898342, 4753.691010084333, 4804.375431193992, 4816.783244753994, 4152.294110001307, 4157.750534967911, 4166.541680415152, 4171.770552619574, 4205.957940420618, 4278.7860606969525, 4329.15581461612, 4329.32895401207, 4367.27939889921, 4367.868963931087, 4534.478534968389, 4559.338895860015, 4562.771861406983, 4566.8173273068705, 4593.035462552768, 4813.061453016629, 4819.879503012313, 4822.821484288026, 4828.203346447796, 4874.53691899269, 4502.3921770561865, 4580.725156490621, 4606.930896036495, 4622.930656040095, 4627.53724627548, 4771.6898401603785, 4773.928391074206, 4774.809007639656, 4783.928241076456, 4808.254720518185, 4752.738599377068, 4837.322774811459, 4856.441509226484, 4871.707697538159, 4912.066707325596, 4655.9301610475195, 4691.343211950398, 4702.7883745230865, 4702.988857395676, 4709.81160753566, 4658.114958157939, 4659.627229821674, 4685.672002959896, 4688.531146885284, 4752.144613969519, 4552.248878935071, 4586.770661466847, 4612.469565999953, 4627.46784119817, 4677.321788340603, 4712.882177945578, 4758.64310176745, 4777.784999674954, 4780.426348838162, 4782.210935195793, 4683.203855344532, 4692.48382677912, 4694.671373003994, 4694.906101878011, 4737.194676905004], "value": 4463.006070697502, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [574.4255744255744, 591.28749856423, 602.6771237134489, 608.1182285685757, 612.8161551534539, 38862.94781678382, 40835.18329633406, 40839.18321633565, 44562.554374456246, 44619.77690111545, 40315.0, 40901.38647920276, 40963.59036409635, 41037.7948110259, 41040.58959410405, 7753.61231938405, 7971.561564113971, 7972.601369931509, 7977.401694872879, 7978.2420670036545, 7770.689172433096, 7866.881996770053, 7869.881951770728, 7870.803229919241, 7873.133955264916, 7848.175941526115, 7910.327622152124, 7915.1689072647405, 7918.089419716749, 7920.891075249469, 7825.960870195641, 7862.76411707644, 7879.487833290817, 7881.09367422748, 7881.921180788233, 7767.883481747778, 7825.413094017971, 7830.0, 7861.96069019657, 7865.685372585147, 37657.435138472945, 38201.808990954865, 38209.23581528381, 38243.23513529714, 38305.425418618746, 2630.395009147888, 2804.4951908656435, 2842.0905310300714, 2962.318666706648, 3023.4557779599663, 29677.554836677467, 29754.0, 29875.103746887627, 29968.0, 30927.845360773277, 3437.071990562559, 3439.4840773883866, 3448.2758620689433, 3473.218525831693, 3495.5106285120105, 259593.0, 260395.0, 260481.0, 261272.0, 261863.0, 45928.77035614801, 46289.0, 46502.0, 46549.53450465452, 46659.0, 45739.0, 54185.1872221917, 55189.44810551924, 55435.445645543834, 61981.690091550154, 14000.229987350793, 14087.084339517898, 14091.365888534836, 14154.575362739135, 14162.858371416154, 9348.065193480597, 11227.438628068563, 11374.374409407563, 11374.829377559343, 11404.0, 15858.286377113058, 16180.67638647244, 16399.672006559802, 16801.0, 16831.74752378715, 6113.266408031065, 6262.624242545462, 6311.715972781236, 6419.903701444482, 6526.608403495806, 784.7998760316083, 798.7963069417261, 931.2968708624945, 1034.6999370182564, 1056.102313033915, 27600.585991210148, 28527.144185674464, 28617.856910715313, 28683.0, 29012.85493572561, 949.6296444386695, 959.8752162218867, 988.1600639456404, 1006.8288390973552, 1008.7226012846526, 14808.0, 15094.320755566026, 15180.772288415683, 15228.162451065298, 15233.542993710207, 362412.0, 366326.0, 366840.0, 366919.0, 366957.0, 48674.26988595174, 49547.25679114816, 49585.75207123941, 49637.0, 49820.750896245285, 1057.724991502215, 1119.4067144413636, 1154.6593754842343, 1181.1613754234418, 1198.6224339333082, 28188.295292617848, 29011.0, 29197.270068248465, 29974.70025299719, 29983.250418739706, 41659.0, 41941.161176776906, 42302.0, 42353.36469952892, 42377.36433953555, 302030.0, 304836.0, 305007.0, 305131.0, 305655.0, 31295.37409251848, 35445.0, 36453.63546364608, 36823.815880920425, 39423.802880985415, 41203.0, 41990.37014444847, 42160.1567968645, 42707.14585708206, 42844.78577607092, 35707.82146089357, 36128.4580731284, 36741.816290918374, 36795.44806827953, 37057.81471092627, 36141.63858361488, 36198.0, 36291.274174515835, 36304.0, 36624.81687591651, 31429.52855707212, 31930.84034579905, 35206.64793352136, 35344.46983295201, 35731.642683573875, 30772.38455230838, 32228.35543289074, 32783.67216327806, 32810.50784238191, 32814.17964550905, 24807.379815504755, 25164.0, 25183.74816251814, 25283.028290344915, 25685.743142568335], "value": 17551.31211831374, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [352.73368606701933, 369.136221242293, 373.26280595823243, 375.1783593929296, 386.44352132928583, 12905.935470322647, 16327.918360408195, 16639.50081497554, 16917.154142292868, 17949.7307540387, 16365.181740912967, 16998.40505582305, 17398.82601173988, 17601.64796704065, 17813.7327940081, 4958.628102892289, 5212.139996900526, 5537.307836520435, 5553.972230138844, 5590.524805391527, 3421.4183588789965, 5010.473900240477, 5329.440408757064, 5344.22508736233, 5449.618526703132, 5365.248865158881, 5369.167778994262, 5385.78456861727, 5388.892222155555, 5393.460653934614, 5281.128613778722, 5386.1920711893135, 5574.219609254707, 5574.916376254359, 5663.433656634304, 3318.1372843060735, 5046.293518907356, 5353.7590808413715, 5368.946310536923, 5446.2375267462585, 12018.51925922962, 12159.0, 12248.142630015902, 13845.723085538333, 20991.685124723143, 1957.862949593529, 1998.6502362086576, 2000.6598878190744, 2098.646373089349, 2192.47380628648, 8982.10178982103, 9226.723198304062, 12879.613611591667, 13307.667308317272, 13558.457661693521, 1709.1283445442914, 1731.8787684862066, 1767.1605987156127, 1797.2002458905793, 1800.734038156047, 67454.66272668606, 68043.65978170077, 69510.30489695088, 69980.3001969979, 71831.0, 8812.95593522041, 9046.728598142066, 9504.524773761284, 9664.468454234944, 10189.847152292721, 13217.14088584239, 13536.323183840768, 13580.38888250031, 13588.728225435436, 13590.796138057936, 7054.6825392857445, 7167.4266058715175, 7176.138863336433, 7241.058662373963, 7304.890426643605, 6798.252192258848, 6825.317468253234, 6853.0, 6933.1333583302085, 6958.965205173941, 4218.472690913636, 4257.638100761408, 4287.978560107242, 4292.484901811803, 4313.468718604913, 1779.6084861330487, 1794.9012804295628, 1831.835134837871, 1834.8073452287585, 1860.8883466992024, 818.6888982186731, 834.6953362022819, 861.1517655109712, 866.7269810009826, 949.4682977532603, 16675.416360427327, 17169.055701936515, 17226.827731722773, 17586.472405827844, 17620.559486012953, 834.1408349400127, 839.6011894350135, 848.8769128476337, 861.4788053227833, 896.7220161749748, 9254.565542340948, 9805.362651427777, 9853.02939412106, 9856.112949834549, 9916.553755081039, 375662.0, 377526.0, 377617.0, 384871.0, 391896.0, 87486.0, 89221.55389223012, 91499.0, 92867.53566232126, 93458.53270733602, 885.274075258282, 888.693400776731, 930.437085563238, 930.5300823084299, 932.0167223579053, 15804.920975395049, 16016.679666406373, 16134.112623805804, 16162.0, 16164.515064548083, 29351.0, 33959.0, 35079.0, 37988.0, 38698.80650596729, 47086.29370559376, 48392.27411588899, 55844.0, 59490.70254648699, 60024.69987650034, 7352.338289553966, 7378.815529611803, 7403.370713489198, 7753.651085701044, 7873.488223265698, 10820.4048777318, 11653.825192622287, 11850.170488065753, 11948.34284114382, 12000.118989776905, 9775.0, 10002.24983126254, 10069.395836249849, 10337.0, 10374.36040933818, 9127.0, 9200.539973001458, 9299.349045566745, 10061.144802691853, 10606.257561970588, 9619.903800961902, 9935.0, 10125.493725313852, 10131.088202061555, 10217.489125543842, 7590.582517961565, 7614.619269036637, 7631.923680763121, 7657.272559106876, 7843.56860372685, 9254.676086336945, 9422.057794220524, 9441.244700423813, 9542.664027036082, 9626.748522692005], "value": 8139.692311284546, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1366.323669783457, 1408.3732738931176, 1484.3172140815225, 1646.6871294454045, 1695.8388953049464, 7002.929970700291, 7397.445191610637, 7446.515976461526, 7446.590437525941, 7460.701571937123, 6308.873822523547, 6846.452283817295, 7134.5719256844495, 7158.0, 7325.194228634846, 2046.5906818636295, 2120.766715661276, 2121.6393213153724, 2123.1189056541516, 2125.6492678707996, 2097.81119699227, 2110.4090854560673, 2140.1118535807623, 2140.336495686342, 2142.4215461825297, 1856.5173055005662, 2055.6094342074957, 2113.746350437942, 2117.036748279537, 2141.2612648636195, 2097.3603051069417, 2142.0467891788085, 2158.9999999999923, 2161.5784921940226, 2165.653495440722, 2143.5605700831293, 2147.098218748114, 2149.376680762577, 2150.3978885911815, 2154.9353519394444, 7311.232320606313, 7411.740589079411, 7415.777526674208, 7419.554826710415, 7420.703171873119, 4157.875263742093, 4259.680523960716, 4262.87211383659, 4274.764887931163, 4282.036541778106, 2633.855137967411, 2750.4636595863813, 2757.765589924859, 2758.931026724348, 2766.39139389336, 878.7934835313696, 896.9775755606097, 912.8174365127002, 915.7802127489422, 927.2813569483636, 9799.706008819676, 10021.198304135653, 10097.646582369582, 10101.848472272923, 10113.0, 3891.7275790694944, 3994.72036957416, 4128.339465685536, 4133.297339452301, 4164.562720914321, 8654.567271636393, 8706.782330441663, 8713.215810577078, 8719.65121395137, 8720.781980450412, 4374.825006999748, 4418.138462999685, 4424.60178583929, 4429.202743506135, 4430.712003719748, 3913.882583522499, 3952.446657467957, 3996.4005399190355, 4002.3596224603925, 4039.8586049488126, 3396.847141878621, 3476.3916314644835, 3496.30073985204, 3540.7698499597445, 3546.2730140321173, 1063.5852017713098, 1089.3790539392628, 1146.7247860513583, 1155.4338374196584, 1163.976720465586, 637.6620391192675, 647.3397134922353, 647.9254885688111, 695.7460526907744, 720.8558288342352, 4977.65156439053, 5021.468452122138, 5024.397072351268, 5066.08810414129, 5067.873303167376, 793.6904607203195, 835.4736515994884, 846.8052347959881, 846.8306338732154, 852.3394369363792, 3185.1240908749814, 3203.3112880730287, 3213.7107660310685, 3218.1471909943884, 3218.468952622838, 8872.334574906909, 9137.04061073591, 9221.677241296522, 9240.3993740408, 9250.306227033, 8873.29013678904, 8936.821263574691, 9094.909050909406, 9113.407628504126, 9132.771680707903, 6749.190097188369, 6823.1812182538415, 6827.795166145023, 6842.178938527309, 6883.346082122191, 4713.104510143062, 4752.619790416689, 4793.880152996203, 4814.927776083291, 4873.512648735098, 8102.189781021851, 8327.875081873655, 8373.748787536384, 8401.70594029206, 8406.705765298186, 8537.018242902146, 8630.093840146694, 8691.86962195555, 8846.380753347205, 8877.73366798997, 6824.829379265558, 6915.101036865175, 6938.722451102101, 6969.9303006969285, 6972.058772065909, 6709.027191057172, 6778.8983165251575, 6780.321967803377, 6895.448364130757, 6954.269801670954, 4499.662525310549, 6051.5461340400525, 6192.59748116389, 6257.2491301044165, 6466.385693359123, 6134.355892631388, 6155.969220153871, 6182.505399568114, 6199.752009919553, 6342.904856427065, 5501.14732216507, 6061.515078793598, 6074.908876366946, 6117.938820611915, 6135.110408990582, 4195.559466255999, 4239.491261048694, 4241.427407299975, 4272.252355837654, 4295.763732994716, 4236.131593023484, 4316.115196384796, 4406.911861762811, 4423.402840616604, 4440.22296098188], "value": 3912.7317248125864, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [293.6549554273728, 301.3490859742955, 302.43595694030626, 305.2369077306733, 305.5676218151316, 4732.195526760451, 4754.144254034272, 4757.119932812432, 4765.666403351766, 4774.283857421388, 4631.8147274109, 4649.488556258817, 4710.623150147989, 4711.882202944919, 4727.369057675105, 3510.1217002058324, 3569.5538057742783, 3628.9677780443035, 3677.7679477374977, 3731.1791405890795, 3680.4479328100733, 3687.8340474678703, 3705.94441083384, 3715.136258291374, 3716.9442458363146, 3507.8421471033867, 3686.3548878946212, 3687.2809802088605, 3690.782041926171, 3696.6488183622646, 3501.9474707879403, 3614.2590768892314, 3617.3488772021024, 3625.365561026823, 3688.649578290085, 3279.770416070876, 3280.655531169217, 3282.983585082083, 3286.1620286826947, 3291.8683252669866, 4544.568266014723, 4549.545045495457, 4559.452865656142, 4569.1547063793305, 4575.290829921368, 4106.568810274908, 4169.97915010423, 4192.664586833076, 4194.580541945811, 4206.875527858412, 4799.408319507462, 4814.820369009615, 4825.300331451955, 4841.588464980481, 4849.127157111719, 3564.681068004829, 3565.4295312750096, 3576.660217279354, 3582.1223800168864, 3583.569971603424, 4916.852494425173, 5073.34046573943, 5082.466341034212, 5091.338126043628, 5109.704240764686, 3671.1005803578296, 3675.852965881335, 3682.963170368316, 3684.4473329000866, 3697.352963231424, 3728.217074414403, 3734.589195188527, 3736.9065773355883, 3737.850485980585, 3741.4761933329355, 4179.582041795796, 4188.979055104766, 4195.643370313557, 4205.831766729297, 4208.516020657602, 4732.73969931657, 4845.733484658307, 4854.713500922258, 4882.584980276645, 4897.583705385082, 1278.5525066226746, 1286.8584455709865, 1292.8383952006, 1293.340396397825, 1297.3383574377135, 820.7455688736392, 842.309306368784, 852.5694524265207, 854.4875570240639, 859.4757198109148, 4009.538903026131, 4192.601702838226, 4288.978555107205, 4382.8904277392685, 4397.8240870364825, 5038.823641172615, 5041.655630132006, 5046.823361182414, 5050.343455350854, 5073.594112470993, 4391.604755572014, 4401.471823381215, 4412.492563355191, 4422.646188304928, 4430.712003719748, 2560.974390256111, 2639.142278759411, 2679.6601699150424, 2703.5809449535354, 2706.5384692265957, 4831.637627177975, 4832.565069143794, 4836.250381190851, 4851.830185943475, 4856.708597484092, 5155.329807125125, 5175.689458632494, 5183.896322073613, 5190.09173394662, 5199.246109314204, 4686.507916668769, 4769.379980602569, 4823.397075365579, 4830.541098595628, 4833.371661684029, 5059.519345662156, 5062.67092638992, 5071.974640126776, 5075.847724568269, 5082.796688132434, 4932.53140951609, 4940.827071052639, 4942.481039490802, 4987.576056035277, 4991.800327986985, 4671.18254305502, 4815.662903596854, 4829.27560865873, 4830.898559126791, 4846.127697014571, 3655.762375445694, 3655.7989310588173, 3664.1389273521236, 3682.1899182179877, 3684.871029513954, 4988.575971042502, 4999.600031997359, 5013.924791128063, 5037.244413338029, 5037.622178336566, 4665.5101214372, 4861.343718598086, 4867.123917694849, 4867.70793752376, 4900.901981960412, 4867.14824905633, 4877.658563900635, 4882.975585122052, 4889.90220195587, 4890.2909078184175, 4787.904241915212, 4795.784189711401, 4821.662483626113, 4827.889585395449, 4833.0, 4732.219183834629, 4894.143524883202, 4902.779374928065, 4904.435989861069, 4915.729634870117, 4793.736344501086, 4797.304390863375, 4799.712017278975, 4810.735409552508, 4825.479973808239], "value": 3722.284528387317, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [597.2057163971917, 608.6743592178185, 625.0468036244729, 652.634524666187, 683.0744341417379, 11789.941050294747, 12606.495740170381, 12625.179363341387, 12636.747265054704, 12639.304838233893, 12437.191582547128, 12757.681057973532, 12882.806757898616, 12906.741865162714, 12934.805977910339, 623.0840664223584, 741.5958302725, 744.1219361153836, 755.1881727143316, 761.973330933416, 762.2491845532146, 770.9575973321465, 774.3340726974798, 774.6514068669094, 776.3905334312566, 825.8513467575834, 829.7178959153887, 830.7258604660477, 831.0484495252932, 831.8211584509329, 641.1792905081503, 761.0676920772065, 786.4062632712323, 789.2935822438942, 793.0443815202667, 580.3007376111775, 583.4078410413434, 584.1121495327079, 585.023011570678, 585.2304219950751, 12348.320842353667, 12385.256884586863, 12400.751984960341, 12411.379431028412, 12414.131010829245, 11705.239159454608, 11756.0, 11848.0, 12124.27254364741, 12335.5065797368, 11393.715157121138, 11406.258593191416, 11450.885491145065, 11701.941490292495, 11997.580084696994, 3878.786666733357, 3911.5110611173604, 3917.745346552465, 3934.1344904121047, 4041.7777022263763, 58791.70604146952, 60401.395986040014, 61471.69264153695, 62150.68924655393, 62314.37685623131, 8521.53131577769, 8818.29453643707, 8822.426542274732, 8869.379143459895, 8892.0, 14992.175430351217, 15011.099334039774, 15036.323365448581, 15380.846191538165, 15714.371425142866, 6153.323134455206, 6294.716737746812, 6298.622082675054, 6415.1981002374705, 6435.0, 3545.0782796472586, 3571.62497937718, 3605.188832512664, 3608.6752192302292, 3638.43604241343, 2609.165067178523, 2677.8527181004843, 2691.2733561938167, 2697.905573304925, 2701.054630879177, 381.28128477818956, 455.1602293767993, 477.53440395614, 479.47258016182616, 522.1775703267369, 533.2055237695805, 546.2598179466845, 562.8198976327618, 564.9548036157098, 565.9320881494247, 8188.181181881764, 8380.58097095155, 8443.0, 8448.930012147064, 8907.421017633833, 433.9739615623073, 525.6793356052805, 526.2001757328915, 531.5548968753859, 531.9520544527275, 3901.141748815256, 3915.530136383652, 3966.960330396717, 3990.3415936370175, 4028.959710402917, 62065.0, 81147.5942620295, 108240.0, 113481.0, 113638.0, 53147.0, 68921.3107868915, 78129.60935195288, 80605.0, 83518.58240708758, 47075.76462117668, 55138.724306379016, 70775.2922470779, 74673.62663186649, 75589.24410755932, 8771.561421929006, 8880.73357799267, 8891.422057566237, 9019.729408117766, 9092.772680683036, 39188.41217381685, 41586.58413415827, 42178.0, 42455.7877210612, 43174.0, 61966.0, 65319.0, 65604.67197664172, 65647.0, 65848.34151658422, 8995.91004089977, 9021.368504204906, 9178.908210917805, 10802.0, 11232.213745038096, 10587.100096491577, 10690.091342235997, 10877.075448586958, 10993.120550356112, 11135.10919126484, 10439.53022114022, 10490.370577765358, 10509.106725928381, 10634.787304254027, 10934.45327733626, 10102.0, 10709.678709638723, 12540.122191446511, 12763.425645845773, 12959.740805184032, 11246.437678115897, 12043.337616431181, 12141.150119491904, 12155.817662735242, 12752.4261408235, 10070.748231294276, 10657.094146997591, 10772.138228941823, 11056.778864422828, 11183.217174797686, 10286.794264114826, 10902.127829773757, 10986.340819550853, 11072.0, 11089.722756931142], "value": 6309.937128176579, "unit": "score"}], "name": "dromaeo_css", "value": 6232.355989005558, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 114.0, 114.0, 114.0, 113.0, 113.0, 113.0, 114.0, 113.0, 113.0], "value": 112.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 125.0, 125.0, 180.0, 123.0, 123.0, 144.0, 121.0, 172.0, 121.0], "value": 138.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 160.0, 160.0, 162.0, 162.0, 161.0, 161.0, 163.0, 161.0], "value": 161.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 76.0, 114.0, 76.0, 77.0, 75.0, 76.0, 106.0, 76.0], "value": 82.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 92.0, 116.0, 85.0, 86.0, 85.0, 114.0, 84.0, 85.0, 128.0], "value": 96.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 118.0, 117.0, 118.0, 117.0, 117.0, 117.0, 118.0, 118.0], "value": 117.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 147.0, 146.0, 146.0, 146.0, 146.0, 147.0, 146.0, 150.0], "value": 146.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 94.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0], "value": 94.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 63.0, 62.0, 63.0, 63.0, 64.0, 63.0, 63.0, 63.0, 63.0], "value": 63.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 65.0, 65.0, 65.0, 64.0, 64.0, 65.0, 66.0, 65.0], "value": 64.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 81.0, 85.0, 80.0, 79.0, 78.0, 77.0, 84.0, 77.0, 86.0], "value": 81.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 128.0, 126.0, 131.0, 131.0, 141.0, 129.0, 131.0, 166.0, 134.0], "value": 135.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 169.0, 167.0, 166.0, 168.0, 166.0, 166.0, 164.0, 166.0, 165.0], "value": 166.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 67.0, 66.0, 70.0, 70.0, 67.0, 67.0, 65.0, 67.0], "value": 67.5, "unit": "score"}], "name": "kraken", "value": 1529.2, "alertThreshold": 2.0}]} 02:39:38 INFO - Return code: 0 02:39:38 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 02:39:38 INFO - # TBPL SUCCESS # 02:39:38 INFO - Running post-action listener: _resource_record_post_action 02:39:38 INFO - ##### 02:39:38 INFO - ##### Finished run-tests step (success) 02:39:38 INFO - ##### 02:39:38 INFO - Running post-run listener: _resource_record_post_run 02:39:38 INFO - Total resource usage - Wall time: 1199s; CPU: 13.0%; Read bytes: 4096; Write bytes: 550522880; Read time: 12; Write time: 383896 02:39:38 INFO - TinderboxPrint: CPU usage
13.0% 02:39:38 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 02:39:38 INFO - TinderboxPrint: I/O write bytes / time
550,522,880 / 383,896 02:39:38 INFO - TinderboxPrint: CPU idle
8,328.7 (87.0%) 02:39:38 INFO - TinderboxPrint: CPU user
1,199.1 (12.5%) 02:39:38 INFO - TinderboxPrint: Swap in / out
0 / 0 02:39:38 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 246112256; Read time: 0; Write time: 218400 02:39:38 INFO - run-tests - Wall time: 1183s; CPU: 13.0%; Read bytes: 0; Write bytes: 288088064; Read time: 0; Write time: 161260 02:39:39 INFO - Running post-run listener: _upload_blobber_files 02:39:39 INFO - Blob upload gear active. 02:39:39 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 02:39:39 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 02:39:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 02:39:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 02:39:39 INFO - (blobuploader) - INFO - Open directory for files ... 02:39:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 02:39:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:39:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:39:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 02:39:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:39:44 INFO - (blobuploader) - INFO - Done attempting. 02:39:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 02:39:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:39:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:39:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 02:39:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:39:46 INFO - (blobuploader) - INFO - Done attempting. 02:39:46 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 02:39:46 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:39:46 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:39:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 02:39:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:39:46 INFO - (blobuploader) - INFO - Done attempting. 02:39:46 INFO - (blobuploader) - INFO - Iteration through files over. 02:39:47 INFO - Return code: 0 02:39:47 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 02:39:47 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 02:39:47 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9f52ab709477f2b2cd05a505efa7ec04964c155f7ff3fbe69db09539538aa8cee34ea2ffad0e5fa8e7dba06efa2ff278fbfa7c2ce1412866b519e6c8f1148c9f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/1d124914f0080d39cfa57e7bf9490d3b44e3fbfa696ae8bf24e22c3ab6a83672511089ebdd26cb19c8119a8363da987cc1edef89f3b06dc313d25cf8e9d92b92", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f4d2773bb4f950c739cac780a4c95b5b96034d878bc556ff080df3990aff554a8f55b4f34b71633d6615ffdb12820598311d6c044b54365eecca0de24369fe00"} 02:39:47 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 02:39:47 INFO - Writing to file /builds/slave/test/properties/blobber_files 02:39:47 INFO - Contents: 02:39:47 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9f52ab709477f2b2cd05a505efa7ec04964c155f7ff3fbe69db09539538aa8cee34ea2ffad0e5fa8e7dba06efa2ff278fbfa7c2ce1412866b519e6c8f1148c9f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/1d124914f0080d39cfa57e7bf9490d3b44e3fbfa696ae8bf24e22c3ab6a83672511089ebdd26cb19c8119a8363da987cc1edef89f3b06dc313d25cf8e9d92b92", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f4d2773bb4f950c739cac780a4c95b5b96034d878bc556ff080df3990aff554a8f55b4f34b71633d6615ffdb12820598311d6c044b54365eecca0de24369fe00"} 02:39:47 INFO - Running post-run listener: copy_logs_to_upload_dir 02:39:47 INFO - Copying logs to upload dir... 02:39:47 INFO - mkdir: /builds/slave/test/build/upload/logs 02:39:47 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.618394 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-07-11 02:39:46.855460) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-11 02:39:46.858906) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9f52ab709477f2b2cd05a505efa7ec04964c155f7ff3fbe69db09539538aa8cee34ea2ffad0e5fa8e7dba06efa2ff278fbfa7c2ce1412866b519e6c8f1148c9f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/1d124914f0080d39cfa57e7bf9490d3b44e3fbfa696ae8bf24e22c3ab6a83672511089ebdd26cb19c8119a8363da987cc1edef89f3b06dc313d25cf8e9d92b92", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f4d2773bb4f950c739cac780a4c95b5b96034d878bc556ff080df3990aff554a8f55b4f34b71633d6615ffdb12820598311d6c044b54365eecca0de24369fe00"} build_url:https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011130 build_url: 'https://queue.taskcluster.net/v1/task/TnMksO4vTs61XSIpKzJdsA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9f52ab709477f2b2cd05a505efa7ec04964c155f7ff3fbe69db09539538aa8cee34ea2ffad0e5fa8e7dba06efa2ff278fbfa7c2ce1412866b519e6c8f1148c9f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/1d124914f0080d39cfa57e7bf9490d3b44e3fbfa696ae8bf24e22c3ab6a83672511089ebdd26cb19c8119a8363da987cc1edef89f3b06dc313d25cf8e9d92b92", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f4d2773bb4f950c739cac780a4c95b5b96034d878bc556ff080df3990aff554a8f55b4f34b71633d6615ffdb12820598311d6c044b54365eecca0de24369fe00"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-11 02:39:46.884033) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:39:46.884371) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1468220272.865694-974293050 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004498 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-11 02:39:46.967409) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-11 02:39:46.967726) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-11 02:39:46.968025) ========= ========= Total master_lag: 0.29 =========