builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-032 starttime: 1480749063.94 results: success (0) buildid: 20161202221844 builduid: b24133900846405a94f0b13723963c53 revision: 557548714db55136b51e1129d649e2599797985f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:03.941308) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:03.948368) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:03.948702) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:03.966438) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:03.966979) ========= 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=745a4373a2a16df560f216e000000264-1480740029.331681-1467241711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-12-02 23:11: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: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.1M=0s 2016-12-02 23:11:04 (46.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.157732 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:04.151193) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:04.151516) ========= 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=745a4373a2a16df560f216e000000264-1480740029.331681-1467241711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019566 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:04.210925) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:04.214324) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 557548714db55136b51e1129d649e2599797985f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 557548714db55136b51e1129d649e2599797985f --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=745a4373a2a16df560f216e000000264-1480740029.331681-1467241711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-12-02 23:11:05,078 truncating revision to first 12 chars 2016-12-02 23:11:05,078 Setting DEBUG logging. 2016-12-02 23:11:05,079 attempt 1/10 2016-12-02 23:11:05,079 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/557548714db5?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-12-02 23:11:05,720 unpacking tar archive at: mozilla-central-557548714db5/testing/mozharness/ program finished with exit code 0 elapsedTime=0.968462 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:05.204707) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:05.205083) ========= script_repo_revision: 557548714db55136b51e1129d649e2599797985f ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:05.205587) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:05.205921) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-02 23:11:05.218241) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-12-02 23:11:05.218576) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-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', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-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=745a4373a2a16df560f216e000000264-1480740029.331681-1467241711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:11:06 INFO - MultiFileLogger online at 20161202 23:11:06 in /builds/slave/test 23:11:06 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 23:11:06 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 23:11:06 INFO - {'append_to_log': False, 23:11:06 INFO - 'base_work_dir': '/builds/slave/test', 23:11:06 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 23:11:06 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 23:11:06 INFO - 'branch': 'Firefox-Non-PGO', 23:11:06 INFO - 'buildbot_json_path': 'buildprops.json', 23:11:06 INFO - 'config_files': ('talos/linux_config.py',), 23:11:06 INFO - 'default_actions': ('clobber', 23:11:06 INFO - 'read-buildbot-config', 23:11:06 INFO - 'download-and-extract', 23:11:06 INFO - 'populate-webroot', 23:11:06 INFO - 'create-virtualenv', 23:11:06 INFO - 'install', 23:11:06 INFO - 'run-tests'), 23:11:06 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:11:06 INFO - 'download_minidump_stackwalk': True, 23:11:06 INFO - 'download_symbols': 'ondemand', 23:11:06 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:11:06 INFO - 'tooltool.py': '/tools/tooltool.py', 23:11:06 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:11:06 INFO - '/tools/misc-python/virtualenv.py')}, 23:11:06 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:11:06 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:11:06 INFO - 'installer_path': 'installer.exe', 23:11:06 INFO - 'log_level': 'info', 23:11:06 INFO - 'log_name': 'talos', 23:11:06 INFO - 'log_to_console': True, 23:11:06 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:11:06 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:11:06 INFO - 'opt_config_files': (), 23:11:06 INFO - 'pip_index': False, 23:11:06 INFO - 'sps_profile': False, 23:11:06 INFO - 'sps_profile_interval': 0, 23:11:06 INFO - 'suite': 'dromaeojs', 23:11:06 INFO - 'system_bits': '32', 23:11:06 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:11:06 INFO - 'title': 'talos-linux64-ix-032', 23:11:06 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:11:06 INFO - 'use_talos_json': True, 23:11:06 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 23:11:06 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:11:06 INFO - 'work_dir': 'build'} 23:11:06 INFO - [mozharness: 2016-12-03 07:11:06.176729Z] Running clobber step. 23:11:06 INFO - Running pre-action listener: _resource_record_pre_action 23:11:06 INFO - Running main action method: clobber 23:11:06 INFO - rmtree: /builds/slave/test/build 23:11:06 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 23:11:06 INFO - Running post-action listener: _resource_record_post_action 23:11:06 INFO - [mozharness: 2016-12-03 07:11:06.643796Z] Finished clobber step (success) 23:11:06 INFO - [mozharness: 2016-12-03 07:11:06.643894Z] Running read-buildbot-config step. 23:11:06 INFO - Running pre-action listener: _resource_record_pre_action 23:11:06 INFO - Running main action method: read_buildbot_config 23:11:06 INFO - Using buildbot properties: 23:11:06 INFO - { 23:11:06 INFO - "project": "", 23:11:06 INFO - "product": "firefox", 23:11:06 INFO - "script_repo_revision": "production", 23:11:06 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 23:11:06 INFO - "repository": "", 23:11:06 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 23:11:06 INFO - "buildid": "20161202221844", 23:11:06 INFO - "pgo_build": "False", 23:11:06 INFO - "basedir": "/builds/slave/test", 23:11:06 INFO - "buildnumber": 850, 23:11:06 INFO - "slavename": "talos-linux64-ix-032", 23:11:06 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 23:11:06 INFO - "platform": "ubuntu64_hw", 23:11:06 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 23:11:06 INFO - "branch": "mozilla-central", 23:11:06 INFO - "repo_path": "mozilla-central", 23:11:06 INFO - "revision": "557548714db55136b51e1129d649e2599797985f", 23:11:06 INFO - "stage_platform": "linux64", 23:11:06 INFO - "builduid": "b24133900846405a94f0b13723963c53", 23:11:06 INFO - "slavebuilddir": "test" 23:11:06 INFO - } 23:11:06 INFO - Found installer url https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2. 23:11:06 INFO - Running post-action listener: _resource_record_post_action 23:11:06 INFO - [mozharness: 2016-12-03 07:11:06.646359Z] Finished read-buildbot-config step (success) 23:11:06 INFO - [mozharness: 2016-12-03 07:11:06.646446Z] Running download-and-extract step. 23:11:06 INFO - Running pre-action listener: _resource_record_pre_action 23:11:06 INFO - Running main action method: download_and_extract 23:11:06 INFO - mkdir: /builds/slave/test/build/tests 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:06 INFO - trying https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 23:11:06 INFO - Downloading https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 23:11:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 23:11:07 INFO - Downloaded 1361 bytes. 23:11:07 INFO - Reading from file /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 23:11:07 INFO - Using the following test package requirements: 23:11:07 INFO - {u'common': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'], 23:11:07 INFO - u'cppunittest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 23:11:07 INFO - u'firefox-53.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 23:11:07 INFO - u'gtest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 23:11:07 INFO - u'firefox-53.0a1.en-US.linux-x86_64.gtest.tests.zip'], 23:11:07 INFO - u'jittest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 23:11:07 INFO - u'jsshell-linux-x86_64.zip'], 23:11:07 INFO - u'mochitest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 23:11:07 INFO - u'firefox-53.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 23:11:07 INFO - u'mozbase': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'], 23:11:07 INFO - u'reftest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 23:11:07 INFO - u'firefox-53.0a1.en-US.linux-x86_64.reftest.tests.zip'], 23:11:07 INFO - u'talos': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 23:11:07 INFO - u'firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'], 23:11:07 INFO - u'web-platform': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 23:11:07 INFO - u'firefox-53.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 23:11:07 INFO - u'xpcshell': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 23:11:07 INFO - u'firefox-53.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 23:11:07 INFO - Downloading packages: [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 23:11:07 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip 23:11:07 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:11:07 INFO - Fetch https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip into memory 23:11:07 INFO - Expected file size: 20218590 23:11:07 INFO - Obtained file size: 20218590 23:11:12 INFO - Downloading packages: [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 23:11:12 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip 23:11:12 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:11:12 INFO - Fetch https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip into memory 23:11:12 INFO - Expected file size: 20218590 23:11:12 INFO - Obtained file size: 20218590 23:11:17 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip 23:11:17 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 23:11:17 INFO - Fetch https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip into memory 23:11:18 INFO - Expected file size: 14409734 23:11:18 INFO - Obtained file size: 14409734 23:11:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:18 INFO - trying https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 23:11:18 INFO - Downloading https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 23:11:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 23:11:19 INFO - Downloaded 55704452 bytes. 23:11:19 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 23:11:19 INFO - mkdir: /builds/slave/test/properties 23:11:19 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 23:11:19 INFO - Writing to file /builds/slave/test/properties/build_url 23:11:19 INFO - Contents: 23:11:19 INFO - build_url:https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 23:11:20 INFO - Running post-action listener: _resource_record_post_action 23:11:20 INFO - Running post-action listener: set_extra_try_arguments 23:11:20 INFO - [mozharness: 2016-12-03 07:11:20.163649Z] Finished download-and-extract step (success) 23:11:20 INFO - [mozharness: 2016-12-03 07:11:20.163879Z] Running populate-webroot step. 23:11:20 INFO - Running pre-action listener: _resource_record_pre_action 23:11:20 INFO - Running main action method: populate_webroot 23:11:20 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:11:20 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:11:20 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:11:20 INFO - '--tppagecycles', 23:11:20 INFO - '7'], 23:11:20 INFO - 'tests': ['tsvgm']}}, 23:11:20 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:11:20 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 23:11:20 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['dromaeo_css', 'kraken']}, 23:11:20 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 23:11:20 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 23:11:20 INFO - 'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:11:20 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 23:11:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:11:20 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 23:11:20 INFO - 'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['damp', 'tps']}, 23:11:20 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 23:11:20 INFO - 'tests': ['damp', 'tps']}, 23:11:20 INFO - 'g3': {'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['dromaeo_dom']}, 23:11:20 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 23:11:20 INFO - 'g4': {'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['basic_compositor_video']}, 23:11:20 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 23:11:20 INFO - 'other': {'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['a11yr', 23:11:20 INFO - 'ts_paint', 23:11:20 INFO - 'tpaint', 23:11:20 INFO - 'sessionrestore', 23:11:20 INFO - 'sessionrestore_no_auto_restore', 23:11:20 INFO - 'tabpaint']}, 23:11:20 INFO - 'other-e10s': {'tests': ['a11yr', 23:11:20 INFO - 'ts_paint', 23:11:20 INFO - 'tpaint', 23:11:20 INFO - 'sessionrestore', 23:11:20 INFO - 'sessionrestore_no_auto_restore', 23:11:20 INFO - 'tabpaint']}, 23:11:20 INFO - 'other-e10s_l64': {'tests': ['a11yr', 23:11:20 INFO - 'ts_paint', 23:11:20 INFO - 'tpaint', 23:11:20 INFO - 'sessionrestore', 23:11:20 INFO - 'sessionrestore_no_auto_restore', 23:11:20 INFO - 'tabpaint']}, 23:11:20 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 23:11:20 INFO - 'ts_paint', 23:11:20 INFO - 'tpaint', 23:11:20 INFO - 'sessionrestore', 23:11:20 INFO - 'sessionrestore_no_auto_restore', 23:11:20 INFO - 'tabpaint']}, 23:11:20 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['a11yr', 23:11:20 INFO - 'ts_paint', 23:11:20 INFO - 'tpaint', 23:11:20 INFO - 'sessionrestore', 23:11:20 INFO - 'sessionrestore_no_auto_restore', 23:11:20 INFO - 'tabpaint']}, 23:11:20 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['a11yr', 23:11:20 INFO - 'ts_paint', 23:11:20 INFO - 'tpaint', 23:11:20 INFO - 'sessionrestore', 23:11:20 INFO - 'sessionrestore_no_auto_restore', 23:11:20 INFO - 'tabpaint']}, 23:11:20 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['tsvgx', 23:11:20 INFO - 'tsvgr_opacity', 23:11:20 INFO - 'tart', 23:11:20 INFO - 'tscrollx', 23:11:20 INFO - 'cart', 23:11:20 INFO - 'tsvg_static']}, 23:11:20 INFO - 'svgr-e10s': {'tests': ['tsvgx', 23:11:20 INFO - 'tsvgr_opacity', 23:11:20 INFO - 'tart', 23:11:20 INFO - 'tscrollx', 23:11:20 INFO - 'cart', 23:11:20 INFO - 'tsvg_static']}, 23:11:20 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 23:11:20 INFO - 'talos_options': ['--disable-e10s'], 23:11:20 INFO - 'tests': ['tp5o']}, 23:11:20 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 23:11:20 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 23:11:20 INFO - 'talos_options': ['--disable-e10s', 23:11:20 INFO - '--xperf_path', 23:11:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:11:20 INFO - 'tests': ['tp5n']}, 23:11:20 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 23:11:20 INFO - 'talos_options': ['--xperf_path', 23:11:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:11:20 INFO - 'tests': ['tp5n']}}, 23:11:20 INFO - 'talos.zip': {'path': '', 23:11:20 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:11:20 INFO - Running post-action listener: _resource_record_post_action 23:11:20 INFO - [mozharness: 2016-12-03 07:11:20.185457Z] Finished populate-webroot step (success) 23:11:20 INFO - [mozharness: 2016-12-03 07:11:20.185554Z] Running create-virtualenv step. 23:11:20 INFO - Running pre-action listener: _resource_record_pre_action 23:11:20 INFO - Running main action method: create_virtualenv 23:11:20 INFO - Creating virtualenv /builds/slave/test/build/venv 23:11:20 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 23:11:20 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 23:11:20 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:11:20 INFO - Using real prefix '/usr' 23:11:20 INFO - New python executable in /builds/slave/test/build/venv/bin/python 23:11:20 INFO - Installing distribute.............................................................................................................................................................................................done. 23:11:22 INFO - Installing pip.................done. 23:11:22 INFO - Return code: 0 23:11:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 23:11:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 23:11:22 INFO - Reading from file tmpfile_stdout 23:11:22 INFO - Output received: 23:11:22 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 23:11:22 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11: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', 'pip>=1.5'] in /builds/slave/test/build 23:11: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 pip>=1.5 23:11:22 INFO - Using env: {'DISPLAY': ':0', 23:11:22 INFO - 'HOME': '/home/cltbld', 23:11:22 INFO - 'LANG': 'en_US.UTF-8', 23:11:22 INFO - 'LANGUAGE': 'en_US:en', 23:11:22 INFO - 'LOGNAME': 'cltbld', 23:11:22 INFO - 'MAIL': '/var/mail/cltbld', 23:11:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:22 INFO - 'MOZ_NO_REMOTE': '1', 23:11:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:22 INFO - 'NO_EM_RESTART': '1', 23:11:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:22 INFO - 'PWD': '/builds/slave/test', 23:11:22 INFO - 'SHELL': '/bin/bash', 23:11:22 INFO - 'SHLVL': '1', 23:11:22 INFO - 'TERM': 'linux', 23:11:22 INFO - 'TMOUT': '86400', 23:11:22 INFO - 'USER': 'cltbld', 23:11:22 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:22 INFO - '_': '/tools/buildbot/bin/python'} 23:11:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:23 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 23:11:23 INFO - Cleaning up... 23:11:23 INFO - Return code: 0 23:11:23 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 23:11:23 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:23 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:23 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 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 23:11:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 23:11:23 INFO - Using env: {'DISPLAY': ':0', 23:11:23 INFO - 'HOME': '/home/cltbld', 23:11:23 INFO - 'LANG': 'en_US.UTF-8', 23:11:23 INFO - 'LANGUAGE': 'en_US:en', 23:11:23 INFO - 'LOGNAME': 'cltbld', 23:11:23 INFO - 'MAIL': '/var/mail/cltbld', 23:11:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:23 INFO - 'MOZ_NO_REMOTE': '1', 23:11:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:23 INFO - 'NO_EM_RESTART': '1', 23:11:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:23 INFO - 'PWD': '/builds/slave/test', 23:11:23 INFO - 'SHELL': '/bin/bash', 23:11:23 INFO - 'SHLVL': '1', 23:11:23 INFO - 'TERM': 'linux', 23:11:23 INFO - 'TMOUT': '86400', 23:11:23 INFO - 'USER': 'cltbld', 23:11:23 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:23 INFO - '_': '/tools/buildbot/bin/python'} 23:11:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:23 INFO - Downloading/unpacking psutil>=3.1.1 23:11:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 23:11:25 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:11:25 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:11:25 INFO - Installing collected packages: psutil 23:11:25 INFO - Running setup.py install for psutil 23:11:25 INFO - building 'psutil._psutil_linux' extension 23:11:25 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 23:11:25 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 23:11:25 INFO - building 'psutil._psutil_posix' extension 23:11:25 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 23:11:25 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 23:11:25 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:11:25 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:11:25 INFO - Successfully installed psutil 23:11:25 INFO - Cleaning up... 23:11:26 INFO - Return code: 0 23:11:26 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 23:11:26 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:26 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:26 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 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 23:11:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 23:11:26 INFO - Using env: {'DISPLAY': ':0', 23:11:26 INFO - 'HOME': '/home/cltbld', 23:11:26 INFO - 'LANG': 'en_US.UTF-8', 23:11:26 INFO - 'LANGUAGE': 'en_US:en', 23:11:26 INFO - 'LOGNAME': 'cltbld', 23:11:26 INFO - 'MAIL': '/var/mail/cltbld', 23:11:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:26 INFO - 'MOZ_NO_REMOTE': '1', 23:11:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:26 INFO - 'NO_EM_RESTART': '1', 23:11:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:26 INFO - 'PWD': '/builds/slave/test', 23:11:26 INFO - 'SHELL': '/bin/bash', 23:11:26 INFO - 'SHLVL': '1', 23:11:26 INFO - 'TERM': 'linux', 23:11:26 INFO - 'TMOUT': '86400', 23:11:26 INFO - 'USER': 'cltbld', 23:11:26 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:26 INFO - '_': '/tools/buildbot/bin/python'} 23:11:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:26 INFO - Downloading/unpacking mozsystemmonitor==0.3 23:11:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:28 INFO - Downloading mozsystemmonitor-0.3.tar.gz 23:11:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:11:28 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 23:11:28 INFO - Installing collected packages: mozsystemmonitor 23:11:28 INFO - Running setup.py install for mozsystemmonitor 23:11:28 INFO - Successfully installed mozsystemmonitor 23:11:28 INFO - Cleaning up... 23:11:28 INFO - Return code: 0 23:11:28 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 23:11:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:28 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 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 23:11:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 23:11:28 INFO - Using env: {'DISPLAY': ':0', 23:11:28 INFO - 'HOME': '/home/cltbld', 23:11:28 INFO - 'LANG': 'en_US.UTF-8', 23:11:28 INFO - 'LANGUAGE': 'en_US:en', 23:11:28 INFO - 'LOGNAME': 'cltbld', 23:11:28 INFO - 'MAIL': '/var/mail/cltbld', 23:11:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:28 INFO - 'MOZ_NO_REMOTE': '1', 23:11:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:28 INFO - 'NO_EM_RESTART': '1', 23:11:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:28 INFO - 'PWD': '/builds/slave/test', 23:11:28 INFO - 'SHELL': '/bin/bash', 23:11:28 INFO - 'SHLVL': '1', 23:11:28 INFO - 'TERM': 'linux', 23:11:28 INFO - 'TMOUT': '86400', 23:11:28 INFO - 'USER': 'cltbld', 23:11:28 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:28 INFO - '_': '/tools/buildbot/bin/python'} 23:11:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:28 INFO - Downloading/unpacking jsonschema==2.5.1 23:11:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:30 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:11:30 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 23:11: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 23:11: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 23:11: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 23:11: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 23:11: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 23:11: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 23:11:30 INFO - Downloading functools32-3.2.3-2.tar.gz 23:11:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 23:11:31 INFO - warning: no files found matching '*.txt' 23:11:31 INFO - no previously-included directories found matching 'build' 23:11:31 INFO - no previously-included directories found matching 'dist' 23:11:31 INFO - no previously-included directories found matching '.git*' 23:11:31 INFO - Installing collected packages: jsonschema, functools32 23:11:31 INFO - Running setup.py install for functools32 23:11:31 INFO - warning: no files found matching '*.txt' 23:11:31 INFO - no previously-included directories found matching 'build' 23:11:31 INFO - no previously-included directories found matching 'dist' 23:11:31 INFO - no previously-included directories found matching '.git*' 23:11:31 INFO - Successfully installed jsonschema functools32 23:11:31 INFO - Cleaning up... 23:11:31 INFO - Return code: 0 23:11:31 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:31 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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:31 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', 'functools32==3.2.3-2'] in /builds/slave/test/build 23:11:31 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 functools32==3.2.3-2 23:11:31 INFO - Using env: {'DISPLAY': ':0', 23:11:31 INFO - 'HOME': '/home/cltbld', 23:11:31 INFO - 'LANG': 'en_US.UTF-8', 23:11:31 INFO - 'LANGUAGE': 'en_US:en', 23:11:31 INFO - 'LOGNAME': 'cltbld', 23:11:31 INFO - 'MAIL': '/var/mail/cltbld', 23:11:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:31 INFO - 'MOZ_NO_REMOTE': '1', 23:11:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:31 INFO - 'NO_EM_RESTART': '1', 23:11:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:31 INFO - 'PWD': '/builds/slave/test', 23:11:31 INFO - 'SHELL': '/bin/bash', 23:11:31 INFO - 'SHLVL': '1', 23:11:31 INFO - 'TERM': 'linux', 23:11:31 INFO - 'TMOUT': '86400', 23:11:31 INFO - 'USER': 'cltbld', 23:11:31 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:31 INFO - '_': '/tools/buildbot/bin/python'} 23:11:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:31 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 23:11:31 INFO - Cleaning up... 23:11:31 INFO - Return code: 0 23:11:31 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:31 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 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 23:11:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 23:11:31 INFO - Using env: {'DISPLAY': ':0', 23:11:31 INFO - 'HOME': '/home/cltbld', 23:11:31 INFO - 'LANG': 'en_US.UTF-8', 23:11:31 INFO - 'LANGUAGE': 'en_US:en', 23:11:31 INFO - 'LOGNAME': 'cltbld', 23:11:31 INFO - 'MAIL': '/var/mail/cltbld', 23:11:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:31 INFO - 'MOZ_NO_REMOTE': '1', 23:11:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:31 INFO - 'NO_EM_RESTART': '1', 23:11:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:31 INFO - 'PWD': '/builds/slave/test', 23:11:31 INFO - 'SHELL': '/bin/bash', 23:11:31 INFO - 'SHLVL': '1', 23:11:31 INFO - 'TERM': 'linux', 23:11:31 INFO - 'TMOUT': '86400', 23:11:31 INFO - 'USER': 'cltbld', 23:11:31 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:31 INFO - '_': '/tools/buildbot/bin/python'} 23:11:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:31 INFO - Downloading/unpacking blobuploader==1.2.4 23:11:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:33 INFO - Downloading blobuploader-1.2.4.tar.gz 23:11:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:11:33 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:11:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 23:11:34 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:11:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:34 INFO - Downloading docopt-0.6.1.tar.gz 23:11:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 23:11:34 INFO - Installing collected packages: blobuploader, requests, docopt 23:11:34 INFO - Running setup.py install for blobuploader 23:11:34 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:11:34 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 23:11:34 INFO - Running setup.py install for requests 23:11:34 INFO - Running setup.py install for docopt 23:11:34 INFO - Successfully installed blobuploader requests docopt 23:11:34 INFO - Cleaning up... 23:11:35 INFO - Return code: 0 23:11:35 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:11:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:35 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 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 23:11:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 23:11:35 INFO - Using env: {'DISPLAY': ':0', 23:11:35 INFO - 'HOME': '/home/cltbld', 23:11:35 INFO - 'LANG': 'en_US.UTF-8', 23:11:35 INFO - 'LANGUAGE': 'en_US:en', 23:11:35 INFO - 'LOGNAME': 'cltbld', 23:11:35 INFO - 'MAIL': '/var/mail/cltbld', 23:11:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:35 INFO - 'MOZ_NO_REMOTE': '1', 23:11:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:35 INFO - 'NO_EM_RESTART': '1', 23:11:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:35 INFO - 'PWD': '/builds/slave/test', 23:11:35 INFO - 'SHELL': '/bin/bash', 23:11:35 INFO - 'SHLVL': '1', 23:11:35 INFO - 'TERM': 'linux', 23:11:35 INFO - 'TMOUT': '86400', 23:11:35 INFO - 'USER': 'cltbld', 23:11:35 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:35 INFO - '_': '/tools/buildbot/bin/python'} 23:11:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:11:35 INFO - Running setup.py (path:/tmp/pip-pJuRjY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:11:35 INFO - Running setup.py (path:/tmp/pip-ZctVe2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:11:35 INFO - Running setup.py (path:/tmp/pip-2aacJl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:11:35 INFO - Running setup.py (path:/tmp/pip-msouuc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:11:35 INFO - Running setup.py (path:/tmp/pip-1vgfiX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:11:35 INFO - Running setup.py (path:/tmp/pip-94tmXR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:11:35 INFO - Running setup.py (path:/tmp/pip-N8my3a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:11:35 INFO - Running setup.py (path:/tmp/pip-iiiBr3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:11:35 INFO - Running setup.py (path:/tmp/pip-cnwVMg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:11:35 INFO - Running setup.py (path:/tmp/pip-mWKtPD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:11:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:11:35 INFO - Running setup.py (path:/tmp/pip-F5HC3f-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:11:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:11:36 INFO - Running setup.py (path:/tmp/pip-cWtJY6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:11:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:11:36 INFO - Running setup.py (path:/tmp/pip-Hi2jVW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:11:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:11:36 INFO - Running setup.py (path:/tmp/pip-DoZBSb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:11:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:11:36 INFO - Running setup.py (path:/tmp/pip-73FWcz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:11:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:11:36 INFO - Running setup.py (path:/tmp/pip-Z1gNjg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:11:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:11:36 INFO - Running setup.py (path:/tmp/pip-FhOOCG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:11:36 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:11:36 INFO - Running setup.py install for manifestparser 23:11:36 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 23:11:36 INFO - Running setup.py install for mozcrash 23:11:36 INFO - Running setup.py install for mozdebug 23:11:36 INFO - Running setup.py install for mozdevice 23:11:36 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 23:11:36 INFO - Installing dm script to /builds/slave/test/build/venv/bin 23:11:36 INFO - Running setup.py install for mozfile 23:11:36 INFO - Running setup.py install for mozhttpd 23:11:37 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Running setup.py install for mozinfo 23:11:37 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Running setup.py install for mozInstall 23:11:37 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Running setup.py install for mozleak 23:11:37 INFO - Running setup.py install for mozlog 23:11:37 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Running setup.py install for moznetwork 23:11:37 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Running setup.py install for mozprocess 23:11:37 INFO - Running setup.py install for mozprofile 23:11:37 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Running setup.py install for mozrunner 23:11:37 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 23:11:37 INFO - Running setup.py install for mozscreenshot 23:11:38 INFO - Running setup.py install for moztest 23:11:38 INFO - Running setup.py install for mozversion 23:11:38 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 23:11:38 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:11:38 INFO - Cleaning up... 23:11:38 INFO - Return code: 0 23:11:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:38 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 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 23:11:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 23:11:38 INFO - Using env: {'DISPLAY': ':0', 23:11:38 INFO - 'HOME': '/home/cltbld', 23:11:38 INFO - 'LANG': 'en_US.UTF-8', 23:11:38 INFO - 'LANGUAGE': 'en_US:en', 23:11:38 INFO - 'LOGNAME': 'cltbld', 23:11:38 INFO - 'MAIL': '/var/mail/cltbld', 23:11:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:38 INFO - 'MOZ_NO_REMOTE': '1', 23:11:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:38 INFO - 'NO_EM_RESTART': '1', 23:11:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:38 INFO - 'PWD': '/builds/slave/test', 23:11:38 INFO - 'SHELL': '/bin/bash', 23:11:38 INFO - 'SHLVL': '1', 23:11:38 INFO - 'TERM': 'linux', 23:11:38 INFO - 'TMOUT': '86400', 23:11:38 INFO - 'USER': 'cltbld', 23:11:38 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:38 INFO - '_': '/tools/buildbot/bin/python'} 23:11:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:11:38 INFO - Running setup.py (path:/tmp/pip-KykfxS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:11:38 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 23:11:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:11:38 INFO - Running setup.py (path:/tmp/pip-3wCy5x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:11:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 23:11:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:11:38 INFO - Running setup.py (path:/tmp/pip-Th8Ht7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:11:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 23:11:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:11:38 INFO - Running setup.py (path:/tmp/pip-uzXZPs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:11:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 23:11:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:11:38 INFO - Running setup.py (path:/tmp/pip-M5tEzy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:11:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 23:11:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:11:38 INFO - Running setup.py (path:/tmp/pip-P1UItW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:11:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 23:11:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:11:38 INFO - Running setup.py (path:/tmp/pip-3rl1IM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:11:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 23:11:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:11:38 INFO - Running setup.py (path:/tmp/pip-c1Vgc7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:11:39 INFO - Running setup.py (path:/tmp/pip-seKTxv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:11:39 INFO - Running setup.py (path:/tmp/pip-RG5K0G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:11:39 INFO - Running setup.py (path:/tmp/pip-pworKV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:11:39 INFO - Running setup.py (path:/tmp/pip-e5ymKp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:11:39 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)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:11:39 INFO - Running setup.py (path:/tmp/pip-A038ZJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:11:39 INFO - Running setup.py (path:/tmp/pip-yGdGim-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:11:39 INFO - Running setup.py (path:/tmp/pip-IY7HdC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:11:39 INFO - Running setup.py (path:/tmp/pip-AWTfh1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 23:11:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:11:39 INFO - Running setup.py (path:/tmp/pip-UMHiXj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 23:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 23:11:39 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 23:11:39 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 23:11:39 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 23:11:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:11:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:11:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:11:41 INFO - Downloading blessings-1.6.tar.gz 23:11:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 23:11:41 INFO - Installing collected packages: blessings 23:11:41 INFO - Running setup.py install for blessings 23:11:41 INFO - Successfully installed blessings 23:11:41 INFO - Cleaning up... 23:11:41 INFO - Return code: 0 23:11:41 INFO - Done creating virtualenv /builds/slave/test/build/venv. 23:11:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:11:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:11:42 INFO - Reading from file tmpfile_stdout 23:11:42 INFO - Current package versions: 23:11:42 INFO - argparse == 1.2.1 23:11:42 INFO - blessings == 1.6 23:11:42 INFO - blobuploader == 1.2.4 23:11:42 INFO - docopt == 0.6.1 23:11:42 INFO - functools32 == 3.2.3-2 23:11:42 INFO - jsonschema == 2.5.1 23:11:42 INFO - manifestparser == 1.1 23:11:42 INFO - mozInstall == 1.12 23:11:42 INFO - mozcrash == 1.0 23:11:42 INFO - mozdebug == 0.1 23:11:42 INFO - mozdevice == 0.49 23:11:42 INFO - mozfile == 1.2 23:11:42 INFO - mozhttpd == 0.7 23:11:42 INFO - mozinfo == 0.9 23:11:42 INFO - mozleak == 0.1 23:11:42 INFO - mozlog == 3.4 23:11:42 INFO - moznetwork == 0.27 23:11:42 INFO - mozprocess == 0.23 23:11:42 INFO - mozprofile == 0.28 23:11:42 INFO - mozrunner == 6.13 23:11:42 INFO - mozscreenshot == 0.1 23:11:42 INFO - mozsystemmonitor == 0.3 23:11:42 INFO - moztest == 0.7 23:11:42 INFO - mozversion == 1.4 23:11:42 INFO - psutil == 3.1.1 23:11:42 INFO - requests == 1.2.3 23:11:42 INFO - wsgiref == 0.1.2 23:11:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:11:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:42 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 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 23:11:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 23:11:42 INFO - Using env: {'DISPLAY': ':0', 23:11:42 INFO - 'HOME': '/home/cltbld', 23:11:42 INFO - 'LANG': 'en_US.UTF-8', 23:11:42 INFO - 'LANGUAGE': 'en_US:en', 23:11:42 INFO - 'LOGNAME': 'cltbld', 23:11:42 INFO - 'MAIL': '/var/mail/cltbld', 23:11:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:42 INFO - 'MOZ_NO_REMOTE': '1', 23:11:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:42 INFO - 'NO_EM_RESTART': '1', 23:11:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:42 INFO - 'PWD': '/builds/slave/test', 23:11:42 INFO - 'SHELL': '/bin/bash', 23:11:42 INFO - 'SHLVL': '1', 23:11:42 INFO - 'TERM': 'linux', 23:11:42 INFO - 'TMOUT': '86400', 23:11:42 INFO - 'USER': 'cltbld', 23:11:42 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:42 INFO - '_': '/tools/buildbot/bin/python'} 23:11:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 23:11:42 INFO - Cleaning up... 23:11:42 INFO - Return code: 0 23:11:42 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 23:11:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:11:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:11:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:11:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc6be10fe30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2546a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e4120>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, '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': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 23:11:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 23:11:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 23:11:42 INFO - Using env: {'DISPLAY': ':0', 23:11:42 INFO - 'HOME': '/home/cltbld', 23:11:42 INFO - 'LANG': 'en_US.UTF-8', 23:11:42 INFO - 'LANGUAGE': 'en_US:en', 23:11:42 INFO - 'LOGNAME': 'cltbld', 23:11:42 INFO - 'MAIL': '/var/mail/cltbld', 23:11:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:42 INFO - 'MOZ_NO_REMOTE': '1', 23:11:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:42 INFO - 'NO_EM_RESTART': '1', 23:11:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:42 INFO - 'PWD': '/builds/slave/test', 23:11:42 INFO - 'SHELL': '/bin/bash', 23:11:42 INFO - 'SHLVL': '1', 23:11:42 INFO - 'TERM': 'linux', 23:11:42 INFO - 'TMOUT': '86400', 23:11:42 INFO - 'USER': 'cltbld', 23:11:42 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:42 INFO - '_': '/tools/buildbot/bin/python'} 23:11:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:11:42 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 23:11:42 INFO - Cleaning up... 23:11:42 INFO - Return code: 0 23:11:42 INFO - Running post-action listener: _resource_record_post_action 23:11:42 INFO - Running post-action listener: _start_resource_monitoring 23:11:42 INFO - Starting resource monitoring. 23:11:42 INFO - [mozharness: 2016-12-03 07:11:42.647628Z] Finished create-virtualenv step (success) 23:11:42 INFO - [mozharness: 2016-12-03 07:11:42.648143Z] Running install step. 23:11:42 INFO - Running pre-action listener: _resource_record_pre_action 23:11:42 INFO - Running main action method: install 23:11:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:11:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:11:42 INFO - Reading from file tmpfile_stdout 23:11:42 INFO - Detecting whether we're running mozinstall >=1.0... 23:11:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 23:11:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 23:11:42 INFO - Reading from file tmpfile_stdout 23:11:42 INFO - Output received: 23:11:42 INFO - Usage: mozinstall [options] installer 23:11:42 INFO - Options: 23:11:42 INFO - -h, --help show this help message and exit 23:11:42 INFO - -d DEST, --destination=DEST 23:11:42 INFO - Directory to install application into. [default: 23:11:42 INFO - "/builds/slave/test"] 23:11:42 INFO - --app=APP Application being installed. [default: firefox] 23:11:42 INFO - mkdir: /builds/slave/test/build/application 23:11:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 23:11:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 23:11:58 INFO - Reading from file tmpfile_stdout 23:11:58 INFO - Output received: 23:11:58 INFO - /builds/slave/test/build/application/firefox/firefox 23:11:58 INFO - Running post-action listener: _resource_record_post_action 23:11:58 INFO - [mozharness: 2016-12-03 07:11:58.989616Z] Finished install step (success) 23:11:58 INFO - [mozharness: 2016-12-03 07:11:58.989867Z] Running run-tests step. 23:11:58 INFO - Running pre-action listener: _resource_record_pre_action 23:11:58 INFO - Running main action method: run_tests 23:11:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 23:11:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 23:11:58 INFO - Python 2.7.3 23:11:58 INFO - Return code: 0 23:11:58 INFO - grabbing minidump binary from tooltool 23:11:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 23:11:58 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 0x2774f20>, '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 0x26e1c20>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26e1f90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 23:11:58 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 23:11:58 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 23:11:58 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 23:11:59 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:11:59 INFO - Return code: 0 23:11:59 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 23:11:59 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 23:11:59 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 23:11:59 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 23:11:59 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 23:11:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--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 23:11:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-032 --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 23:11:59 INFO - Using env: {'DISPLAY': ':0', 23:11:59 INFO - 'HOME': '/home/cltbld', 23:11:59 INFO - 'LANG': 'en_US.UTF-8', 23:11:59 INFO - 'LANGUAGE': 'en_US:en', 23:11:59 INFO - 'LOGNAME': 'cltbld', 23:11:59 INFO - 'MAIL': '/var/mail/cltbld', 23:11:59 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 23:11:59 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 23:11:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:11:59 INFO - 'MOZ_NO_REMOTE': '1', 23:11:59 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 23:11:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:11:59 INFO - 'NO_EM_RESTART': '1', 23:11:59 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:11:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:11:59 INFO - 'PWD': '/builds/slave/test', 23:11:59 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 23:11:59 INFO - 'SHELL': '/bin/bash', 23:11:59 INFO - 'SHLVL': '1', 23:11:59 INFO - 'TERM': 'linux', 23:11:59 INFO - 'TMOUT': '86400', 23:11:59 INFO - 'USER': 'cltbld', 23:11:59 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1480740029.331681-1467241711', 23:11:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:11:59 INFO - '_': '/tools/buildbot/bin/python'} 23:11:59 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--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 23:11:59 INFO - mozversion application_buildid: 20161202221844 23:11:59 INFO - mozversion application_changeset: 557548714db55136b51e1129d649e2599797985f 23:11:59 INFO - mozversion application_display_name: Nightly 23:11:59 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:11:59 INFO - mozversion application_name: Firefox 23:11:59 INFO - mozversion application_remotingname: firefox 23:11:59 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 23:11:59 INFO - mozversion application_vendor: Mozilla 23:11:59 INFO - mozversion application_version: 53.0a1 23:11:59 INFO - mozversion platform_buildid: 20161202221844 23:11:59 INFO - mozversion platform_changeset: 557548714db55136b51e1129d649e2599797985f 23:11:59 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 23:11:59 INFO - mozversion platform_version: 53.0a1 23:11:59 INFO - using testdate: 1480749119 23:11:59 INFO - actual date: 1480749119 23:11:59 INFO - starting webserver on 'localhost:56715' 23:11:59 INFO - SUITE-START | Running 2 tests 23:11:59 INFO - TEST-START | dromaeo_css 23:11:59 INFO - operating with platform_type : linux_ 23:11:59 INFO - Initialising browser for dromaeo_css test... 23:11:59 INFO - TEST-INFO | started process 15366 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp45zYMo/profile http://localhost:56715/getInfo.html) 23:12:04 INFO - PROCESS | 15366 | __metrics Screen width/height:1600/1200 23:12:04 INFO - PROCESS | 15366 | colorDepth:24 23:12:04 INFO - PROCESS | 15366 | Browser inner width/height: 1024/697 23:12:04 INFO - PROCESS | 15366 | __metrics 23:12:04 INFO - PROCESS | 15366 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 23:12:04 INFO - PROCESS | 15366 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 23:12:06 INFO - TEST-INFO | 15366: exit 0 23:12:06 INFO - Browser initialized. 23:12:06 INFO - Running cycle 1/1 for dromaeo_css test... 23:12:06 INFO - TEST-INFO | started process 15448 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp45zYMo/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:12:18 INFO - PROCESS | 15448 | RSS: Main: 172793856 23:12:18 INFO - PROCESS | 15448 | 23:13:09 INFO - PROCESS | 15448 | 1480749189728 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 23:15:22 INFO - PROCESS | 15448 | Cycle 1(1): loaded http://localhost:56715/tests/dromaeo/cssquery-dojo.html (next: http://localhost:56715/tests/dromaeo/cssquery-ext.html) 23:15:25 INFO - PROCESS | 15448 | RSS: Main: 391647232 23:15:25 INFO - PROCESS | 15448 | 23:18:28 INFO - PROCESS | 15448 | Cycle 1(1): loaded http://localhost:56715/tests/dromaeo/cssquery-ext.html (next: http://localhost:56715/tests/dromaeo/cssquery-jquery.html) 23:18:29 INFO - PROCESS | 15448 | RSS: Main: 288759808 23:18:29 INFO - PROCESS | 15448 | 23:21:31 INFO - PROCESS | 15448 | Cycle 1(1): loaded http://localhost:56715/tests/dromaeo/cssquery-jquery.html (next: http://localhost:56715/tests/dromaeo/cssquery-mootools.html) 23:21:32 INFO - PROCESS | 15448 | RSS: Main: 220905472 23:21:32 INFO - PROCESS | 15448 | 23:24:34 INFO - PROCESS | 15448 | Cycle 1(1): loaded http://localhost:56715/tests/dromaeo/cssquery-mootools.html (next: http://localhost:56715/tests/dromaeo/cssquery-prototype.html) 23:24:35 INFO - PROCESS | 15448 | RSS: Main: 221728768 23:24:35 INFO - PROCESS | 15448 | 23:27:38 INFO - PROCESS | 15448 | Cycle 1(1): loaded http://localhost:56715/tests/dromaeo/cssquery-prototype.html (next: http://localhost:56715/tests/dromaeo/cssquery-yui.html) 23:27:38 INFO - PROCESS | 15448 | RSS: Main: 225431552 23:27:38 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | Cycle 1(1): loaded http://localhost:56715/tests/dromaeo/cssquery-yui.html (next: http://localhost:56715/tests/dromaeo/cssquery-dojo.html) 23:30:42 INFO - PROCESS | 15448 | RSS: Main: 314544128 23:30:42 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | __start_tp_report 23:30:42 INFO - PROCESS | 15448 | _x_x_mozilla_page_load 23:30:42 INFO - PROCESS | 15448 | _x_x_mozilla_page_load_details 23:30:42 INFO - PROCESS | 15448 | |i|pagename|runs| 23:30:42 INFO - PROCESS | 15448 | |0;dojo.html;2572.562664347061;2584.625229341745;2594.4940736556355;2606.400527878588;2619.4237267801077;4431.357453169288;4496.190685676577;4586.885327866801;4601.378813860128;4614.054118905625;4532.388127602772;4634.258518637019;4673.29900514923;4701.083288758685;4731.408573928259;4198.8530401435955;4208.137331846964;4249.915001699964;4291.442112525383;4358.324459708734;3887.403318094256;4191.895202619929;4276.315789473685;4325.848595299165;4365.279728844736;4126.42230087788;4144.564820693814;4288.9785551072355;4345.826166953318;4361.171377438277;4187.309093999486;4219.7046206765535;4254.340577210537;4270.530241673445;4320.719153255029;4258.127083947814;4259.957400425987;4260.360945858115;4264;4303.763293018883;4633.536646335373;4673.953260467386;4682.695624784378;4699.765011749433;4717.646176536773;4822.95177048232;4868.196747536652;4868.78090485929;4893.584045356149;4896.583790377822;4979;4979.850604481871;4987.401511818605;5011.3485246918035;5024.447310795809;4651.37206477128;4653.488116307203;4654.86035418938;4656.511066338054;4693.6949098308505;4924.655274130848;4960.107180707508;4961.2806143109765;5062.139436295838;5117.744112794346;4819.2530157825595;4827.975860120677;4829.806807727722;4851.854444366674;4899.853004409873;4913.533214344631;4928.433230178503;4936.802527898915;4955.4301255356095;4978.2034874419915;4839.782209800567;4883.047805677858;4909.558139767367;4913.680610760289;4959.876003099951;4840.298156767249;4883.633727470454;4884.804607815719;4891;4894.388201474816;4131;4159.022629682022;4159.272127377757;4160.9375859362135;4177.143685544456;3642.4900513928073;3649.872254471081;3651.72612054097;3683.613220611851;3692.8892133236045;4175.185838761412;4290.549492303326;4290.678199135077;4299.441072660534;4344.044310251803;4839;4908.803647854117;4925.507449255046;4951.306817045616;4966.478519755446;4307.375430562551;4308.18144552534;4343.283358245917;4344.174606824693;4348.043430445297;4447.221736196153;4454.22051141049;4456.821727130879;4494.640428765691;4501.617362524156;4536.75047872357;4629.837955671535;4702.106599746037;4702.976485117552;4706.458757242961;4912.1158191525865;4920.45874953762;4927.457979622167;4931.580815630711;4966.428860681068;4675.766211689333;4678.60231880294;4683.531646835289;4686.4610569783545;4692.366530518473;4899.216125419915;4975.402951645826;4979.775910084128;4981.327520784647;4991.3511243538105;4985.601151907911;4994.325766021686;4995.350604421547;4999.225120106389;5040.798368065236;4817.084753896748;4867.464578896389;4868.878278043077;4871.098846713369;4910.337104490848;4632.096741135446;4658.440987081572;4678.883027924329;4713;4714.010057887745;4635.559621835921;4636.6058884995155;4638.768061596839;4645.256758918556;4699.365585645894;4825.541573550507;4842.128416884994;4892.3884514435695;4913.263010548446;4915.7542122893;4578.2903649934315;4590.311453282035;4765.285207218806;4774.856754297377;4819.783109759999 23:30:42 INFO - PROCESS | 15448 | |1;ext.html;578.228065532514;581.5522048023021;589.775885163638;591.9965658209337;593.5607650338748;36347.818260908694;37436.62563374366;37744.245115097685;41929.7903510482;42156.367654485206;39174.60825391745;39581;39685.8015709921;39745.20509589806;39764.80117599415;7211.603361815098;7435.7769266921805;7468.850622987537;7636.312731854132;7642.04474440695;9589.664361747306;9900.108990190882;9906.207503399746;10194.6941591752;10246.48767561619;9881.802363952716;9952;9954.402735835836;9958;9968.202543796478;9756.4633945133;9810.362326448794;9920.503974801231;9926;9929.453880036595;9642.228621710246;9754.756131096708;9755.317127801056;9758.121769040821;9758.414495130244;37029.25941481182;37332.62667373319;37335.25329493422;37380.065498362485;37416.43875341872;2940.3237255431372;3314.121757734202;3315.61870384904;3518.296340731864;3599.94600080999;27778.166655000383;27883.16350509488;27977.16068517948;28422.147335579964;28487.85756071227;3447.293304872495;3497.178163131662;3565.6790888820133;3623.184783423735;3689.889303320878;248263;248978;250089;250666.99999999817;251143;48752.26871596929;48938.26592601114;49117.26324105141;49188;49208.26187607189;47020.5297947023;47025.76487117542;47026.294605580944;47064.2940355895;47142.764286178346;11031.22781405294;11123.888761112285;11130.443477826077;11138.554457821758;11139.275947063416;8443.408961372645;8653.870191947126;8672.176143266379;8673.956630216808;9750.853737193947;13186.076974611877;14191.645208869655;14672.266386680623;14726.190059546614;15226.619334516725;5715.771369145271;5743.3395159557185;5778.8266352009505;5859.794907178313;5904.321003084614;730.5142080516504;752.1237758011855;766.7124828189429;773.6982576795054;863.2230992107028;26598.335041624116;26704.465910681676;27123.321916952234;27193;27244;906.655470921059;919.3518569408551;928.5078908178676;982.6020461713018;986.4919566423298;14118.929405353112;14393;14430.494932677306;14656.435123853284;14722.852771472362;357422.98039137013;359229;359879;361358;363141;46997.06005879932;47003.29495057577;47050.764746176734;47168.5283147171;47175.292370614465;1097.8463015177722;1155.595541560464;1156.1560061155571;1157.1032449851264;1159.976800463986;25412.74587254104;26155;26569.937202511683;26969.865150674123;27141.59287610727;36036.63963360333;36195.819020904724;36211;36220.456693150154;36334.81832590926;318086;319346;320055;320949;321234;34058.82970585131;34832.65167348395;35089.824550877085;35101.824490877385;35134.472982904765;38253.80873095617;38813;38935.24791384338;39500.40749388704;40064;33382;33902.762154730655;33935.32129357448;34079.659203407646;34169.829150854086;33410.66589334173;33695.831520842235;33946.49080263748;34162.48756268708;34401.65598344085;33500.32999340048;34016.14959626029;34037;34355;34369.31261374809;30519.237019074702;30952.22619434442;31198.488840284157;34406;34454.82772586221;24263.272101836974;24434.389140271636;24436.755632444158;24882.875585621958;24912.252632421056 23:30:42 INFO - PROCESS | 15448 | |2;jquery.html;333.03420081762897;343.2825394924607;358.8259694048387;359.696056831977;371.6487918916625;12663;15600.765988510182;15811.209439528035;15890;16549.58626034347;15762.054276743404;16147.838521614809;16494.092824894626;16624;16723.581910452245;4815.735134567597;4830.227163653825;4908.263760435928;4943.604511639061;5055.115354812911;3614.8554057837787;3828.885133446001;4876.926846097312;4956.1822299320565;4956.826511072113;5482.890342193174;5748.223989761371;5765.538756899438;5854.268216472941;5861.472467477947;5630.887382252373;5742.97128514359;5783.797567085132;5834.299884013924;5835.533157347402;5114.872128196787;5126.359205099363;5135.948640513584;5138.997895410396;5139.254808052849;18655.53361165968;19757.20971161152;19902.303419380252;20018.09918553654;20053.498662533406;1873.7657792775904;1883.2372888979985;1912.0439780109946;1922.3367938061485;1925.1914196037699;12690.492380304777;12697.746045079046;12765.36173191346;12967.481300748053;13041.347932603332;1635.2069246415479;1645.0039605637503;1676.4300137953032;1728.2309372329319;1752.1502071495315;43401.03552365916;57298.7135064322;60311;67226;70912.99999999949;8966.820663586692;9115.179633832988;9194.586243619053;9279.768005799773;9306.488143152057;12961.15752476086;12985.02612304081;12989.740205196033;12999.545015924397;13006.674833129247;6803.421709154777;6828.419584335288;6992.545484543489;7000.964995174992;7076.610786406797;6233.158523599347;6310.368963103745;6398.584092034003;6580.934190658128;6601.844677181474;5696.629719068247;5906.7637294508595;5927.347991720907;5932.110183472513;6007.699615019319;1601.279424259088;1683.8905471144337;1708.5643160993866;1712.8372804583544;1743.9302427902996;707.706301884712;810.4003037752021;843.2031730015077;863.4215075899162;983.1397527163732;15904.681906361808;16484.917575412048;16900.492985210465;17201.44633216088;17345.826541734423;822.8313195794848;844.4806444036873;849.6389034660244;865.6148014133776;902;9096.954515227382;9812.705618831447;9813.509324533745;9845.360051596623;9882.209423246122;361512;362267;383874;384355;388059;64777;66611.33388666052;67519;68566.65716671385;69828.65085674539;886.082904194156;894.4096896048577;911.3210658059788;920.130476699526;931.2549960031947;14409.414964353704;14637.926810366305;15219.543413697607;15419.306131223897;15437.614059648598;34826;34900;36255.63744362522;36530.8173459131;36677.81661091677;45837.31244031409;46003.76998114988;46088.308675370565;46283.76858115688;48074;7179.246179151322;7257.274272572911;7467.887981680171;7564;7792.688292468464;11080.39057851826;11275.830862536905;11505.367204803817;12044.397780110785;12156.696082598006;9898.356606820533;9928.453935033642;10179.847302290324;10235.232357573062;10486.423246721199;9983.15143212806;10090.293679442368;10138.79722405533;10172.389656620626;10579.36523808574;9461.95269023678;9531.571079301586;10062.647807326708;10156.746081348025;10522.158227341948;6470.773522926675;6855.177378714586;7392.334689877722;7423.406127509894;7586.924130758622;8756.51839148853;9892.258080644124;9897.158741507052;10344.844827327746;10439.739006524595 23:30:42 INFO - PROCESS | 15448 | |3;mootools.html;1301.7266374061446;1330.3880215101055;1367.84269808972;1591;1608.1717915273643;5901.527877769779;6087.573869829113;6606.570572912758;6987.441004719623;6989.615571143591;6513.8371540711505;6792.354726301006;6794.014867844159;6955.061066755987;6971.024056632075;2056.845736569752;2090.8118269355755;2093.173196587347;2093.518490747129;2094.392626138418;2050.76416212136;2096.9790302096935;2105.3999610111123;2110.7467103947547;2112;2002.6795712685973;2008.9899550502228;2017.788132246115;2019.545602239499;2019.9899000504977;1993.601279744057;2011.095007246745;2011.8088781565727;2012.2956965062258;2016.0927582587747;1741.6952033394105;1808.9909550452296;2009.3168322770182;2013.134352228541;2073.2743539761113;6594.703238354237;6796.626185559792;6811.2167100783545;6953;6957.304269573002;4134.338505839051;4249.150169966019;4276.636485898703;4277.636400905927;4279.700420970534;2667.346500107486;2734.248081777507;2805;2809.90165344212;2817.5351067073907;844.846784139651;849.8640217565222;857.7726902370877;866.7443104284251;886.0120965123905;9143.954280228623;9151.267898568165;9158.221551168159;9158.633654653806;9176.724698259062;3883.76697398157;3965.643092121723;4077.6136113721477;4103.220388126247;4108.589141085928;7896.921030789618;7910.446268761247;7913.406494512935;7914.485558438683;7928.643211055516;4420.3590479380955;4429.933550996738;4431.822727090945;4433.069055498317;4433.534478879671;3948.4077388391397;3987.2424239394422;4062.73592216505;4065.6137666921595;4067.2678917795083;3354.798712077283;3384.8646054157557;3491.738119641037;3501.2647344057523;3516.701080408194;1123.5056575106926;1130.141092769501;1133.8866113388594;1137.294877176156;1143.4740019591081;779.8869163971192;813.7233340664203;815.8816971539212;817.7546735979182;819.4837252530867;4776.808927642925;4883.365162528919;4974.477679843637;4994.076095922266;5054.616833072766;400.71949635255436;401.45602708330375;402.7080366734094;404.9047326980511;404.92104039712564;3312.8840490582716;3399.4220982433044;3412.744044196695;3438.914027149341;3555.0579096539436;7000.124984376953;7329.083864516935;7337.0828646419195;7829.921700783033;8108.756737297773;7509.51188172767;7515.661795219228;7727.613619319011;7976.601169941479;8040.195980401913;6371.108044873721;6402.647854368054;6506.154199953976;6546;6585.571937824122;4839.903201935871;4841.95158048415;4867.395943170387;4907.3620429343955;5010.799568017239;7529.397648188241;7552.584607846621;7557.05536807899;7623.923760762544;7628.084629844454;7442.665080071301;7620.31417172435;7712.807179820325;7770.261825126604;7805.4536182468955;6405.135306733531;6678.599284042973;6681.732730690718;6693.397594216543;6701.296363881722;6646.634435106115;6651;6663.800085997428;6674.766383176566;6721.126253587003;5903;5949.851253718519;6035.577509574287;6110.572259941761;6157.3818442298225;5832.066869300891;5964.582479226413;5971.373005834499;5990.850228744316;6010.909836352371;5633.267675202197;5819.243498345188;5885.735141918538;5893.852653683693;5917.230760001173;4150.543440221513;4254.532001479896;4331.5884990925815;4339.674524410619;4486.573775491323;4413.455290648248;4419.756913369795;4429.15845989261;4563.863084107482;4569.451665800125 23:30:42 INFO - PROCESS | 15448 | |4;prototype.html;293.1878696012045;297.3918337000833;304.2394014962593;306.61213564840466;307.32388744761516;4792.5926296264815;4850.720161524083;4856.730447464505;4861.222204447289;4875.341828853104;4730.526947305277;4742.9051418971685;4774.665773395864;4776.235802271637;4806.519348065201;3541.752077354586;3592.2456284180353;3649.94525082124;3664.2777894389596;3754.793486358249;3703.4074548072313;3710.8330125144435;3736.3648179809497;3741.102135487477;3745.9812700936595;3690.450010995375;3701.7408781385316;3708.7033037356946;3726.2859084821016;3766.114962983697;3563.2160924596546;3588.282343531278;3654.104744337641;3701.7223708221723;3735.8132093395493;3309;3309.12308238317;3310.3213841162506;3311.503274508819;3323.833808309599;4615.953470709315;4618.399608050965;4620.861374158781;4622.14490319292;4628.662525424639;4089.44792453021;4276.358546218092;4279.97860010698;4283.164782867342;4288.24955632763;4910.459849416561;4917.582005529499;4930.580900623451;4938.38270216223;4961.677490963076;3622.8950170198077;3642.1987162824134;3658.378075727133;3669.8165091745304;3671.706263498914;5019.874503137451;5186.118359878792;5188.92216616751;5193.740312984336;5194.740262986873;3682.0978860178893;3703.79629120401;3708.5735140458655;3718.3492888744363;3720.311742327624;3719.34911390511;3729.21686445844;3748.3253014457114;3753.5683396409217;3764.9058773530332;4213.789310534522;4217.135487225111;4222.113356195172;4222.746635201897;4242.830286788494;4847.491013443538;4903.6077113831525;4940.456549779521;4985.4017517897355;4992.925106123411;1256.585326842158;1258.5217617305366;1260.3068312428127;1261.7413430246777;1265.1333836321965;818.7216346442239;835.6532039203662;874.7987962768599;880.8854848869606;884.2969838978028;4175.206710724952;4304.225239456928;4427.313766366218;4442.777861106932;4455.242608756519;5147.124988751922;5154.561862241677;5162.328897243409;5165.845024649267;5167.793288268503;4444.222261104358;4448.399466072104;4452.510223875371;4475.082608065339;4475.351074094238;2488.4276616377974;2653.1377302376804;2659.295286749013;2669.0391459074717;2669.104022136004;4680.297955306663;4700.153972285021;4714.279288059834;4716.575508204278;4728.267118596623;4851.95148048515;5099.821506247264;5116.386033675983;5127.538521533005;5135.435102138762;4674.976625116853;4702.756426584334;4708.858734237979;4709.717416954856;4709.929351059737;4990.4261009982865;5004.024215277986;5004.649674522894;5013.849584512471;5036.823711170238;4648.604868586208;4887.999999999858;4904.386951631046;4904.558589726942;4908.214685650279;4619.353290539394;4644.86065418038;4667.393238878924;4678.532146785295;4687.531226892143;3487.8604855805484;3506.579210494757;3524.8237588121006;3531.858725650945;3558.768680035789;5002.899942001212;5005.471142844359;5016.372953380827;5017.57350625201;5024.397072351341;4682.906341873211;4795.928061079157;4797.592204662643;4866.274886063816;4868;4838.274258861199;4842.782074806712;4845.262426728887;4850.46644869057;4852.466228714909;4758.384367163845;4769.475357710579;4769.523047695203;4776.307435421914;4817.205161148371;4744.952550474451;4885.633577481632;5018.172001619692;5038;5039.722815245197;4926.359573255454;4938.851834444972;4959.380077490314;4978.626603004716;4979.800807967641 23:30:42 INFO - PROCESS | 15448 | |5;yui.html;579.3627010288683;652.7650045983445;709.8154479835241;713.040644304316;741.4846681556314;12630.05274604405;13459.663508412295;13512.256825874572;13533.796993045113;13536.526221582235;12798.872011279884;12908.096433249677;12945.676358091052;12946.93526532366;12950.870491295083;599.5922772514688;615.9538034647397;729.784713509516;733.8532293541286;754.1854796819422;747.6971826410313;750.0249675421957;750.1111183247841;750.114864459937;751.9511231769944;790.5454363740872;790.7034861926777;790.8062524681461;790.8299715561153;791.1771757372326;638.1257676982564;653.7254353171679;654.5908806995627;657.2376043789229;791.0151860933117;557.6431084106175;569.0979797021726;571.7627184718336;575.0856138739424;576.3631187537752;12901.354932253349;12926.676833079247;12951.87048129516;12992.935035324857;13040.608781736562;12263.26420414769;12323.815142772866;12366.938165309115;12515.56195533161;12705.936470317682;11300.378479183642;11344.716382090432;11376.829347559793;11457.88542114585;11597.942010289895;3815.6184381561898;3842.2507611015862;3856.3636999894984;3888.4556162137324;3894.7273690841653;63348;63920.68039659818;64064;65890.3410965889;66198;9960.402375857471;10047.145992590566;10102.292839501164;10153.746156346151;10233.079022887976;18790.234121016394;18939.337123200898;18949.715754263696;18957.620847583246;18961.241550337832;6539.313372095861;6564.7374105036215;6619.66901654925;6812.761553345609;6840.281770414035;3485.2680937003006;3542.2384187399834;3594;3625.728070394731;3651.3427583034777;2764.074035198191;2848.9145325640266;2863.3414314707315;2864.484392809314;2871.9712802872123;482.9106615276185;486.7322972365185;491.97540122993706;492.74869816393897;539.5845199196675;566.2666846433877;597.7429705226795;607.8449995251183;621.4810633121394;622.2905887288495;8148.592570371457;8218.383621228311;8447.873281900776;8495.702650407206;8501;524.5777149394773;550.3258508327267;599.5054080383701;600.2616781358865;606.1513880567153;3670.44943258508;3912.197999410114;3926.1755031443718;3959.6238357356006;4002.959970400317;71622.28377716156;73251;74087;76165;76464;50190;60738.696306518184;61766.0735088974;63580;64090.359096409375;56794.43205567892;57407;57428.425715742305;57937.420625794046;59514.10728839158;7511.51175173612;7617.5048621839405;7736.149023607286;7788.727394541163;8096;33029.17427064342;33650.66349336475;33988.49017264693;37011;40828;47402.52597473981;47896.760516197195;49419.75290123526;49755.75122124366;51041;10746.8387974182;11075.446227688744;11135;11211.495482703134;11274.661760147208;12292.754144917231;12407.069469789622;12524.686882828002;13051.804222936853;13113.737725245252;11265.831012534982;11531.654050378502;11791.35147566892;12183.086268529718;13185.670358241121;11504.769904601693;11891;12301.87698123043;12302.876971230531;12304.323262220663;11137.770046686694;11440.42797860087;11713.590024349107;12350.876491234972;12355.814662779885;9151.405158664666;9301.674441394518;9644.807103857744;9958.452285124387;10323.174146068146;9511.714648560554;10293.228007899288;10451.63419280352;10521.579136834442;10536.736581585521 23:30:42 INFO - PROCESS | 15448 | __end_tp_report 23:30:42 INFO - PROCESS | 15448 | __start_cc_report 23:30:42 INFO - PROCESS | 15448 | _x_x_mozilla_cycle_collect,2577 23:30:42 INFO - PROCESS | 15448 | __end_cc_report 23:30:42 INFO - PROCESS | 15448 | __startTimestamp1480750242389__endTimestamp 23:30:42 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | ------- Summary: start ------- 23:30:42 INFO - PROCESS | 15448 | Number of tests: 6 23:30:42 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | [#0] dojo.html Cycles:165 Average:4565.58 Median:4682.70 stddev:474.87 (10.1%) stddev-sans-first:449.85 23:30:42 INFO - PROCESS | 15448 | Values: 2572.6 2584.6 2594.5 2606.4 2619.4 4431.4 4496.2 4586.9 4601.4 4614.1 4532.4 4634.3 4673.3 4701.1 4731.4 4198.9 4208.1 4249.9 4291.4 4358.3 3887.4 4191.9 4276.3 4325.8 4365.3 4126.4 4144.6 4289.0 4345.8 4361.2 4187.3 4219.7 4254.3 4270.5 4320.7 4258.1 4260.0 4260.4 4264.0 4303.8 4633.5 4674.0 4682.7 4699.8 4717.6 4823.0 4868.2 4868.8 4893.6 4896.6 4979.0 4979.9 4987.4 5011.3 5024.4 4651.4 4653.5 4654.9 4656.5 4693.7 4924.7 4960.1 4961.3 5062.1 5117.7 4819.3 4828.0 4829.8 4851.9 4899.9 4913.5 4928.4 4936.8 4955.4 4978.2 4839.8 4883.0 4909.6 4913.7 4959.9 4840.3 4883.6 4884.8 4891.0 4894.4 4131.0 4159.0 4159.3 4160.9 4177.1 3642.5 3649.9 3651.7 3683.6 3692.9 4175.2 4290.5 4290.7 4299.4 4344.0 4839.0 4908.8 4925.5 4951.3 4966.5 4307.4 4308.2 4343.3 4344.2 4348.0 4447.2 4454.2 4456.8 4494.6 4501.6 4536.8 4629.8 4702.1 4703.0 4706.5 4912.1 4920.5 4927.5 4931.6 4966.4 4675.8 4678.6 4683.5 4686.5 4692.4 4899.2 4975.4 4979.8 4981.3 4991.4 4985.6 4994.3 4995.4 4999.2 5040.8 4817.1 4867.5 4868.9 4871.1 4910.3 4632.1 4658.4 4678.9 4713.0 4714.0 4635.6 4636.6 4638.8 4645.3 4699.4 4825.5 4842.1 4892.4 4913.3 4915.8 4578.3 4590.3 4765.3 4774.9 4819.8 23:30:42 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | [#1] ext.html Cycles:180 Average:45877.07 Median:36203.41 stddev:82319.30 (227.4%) stddev-sans-first:82479.97 23:30:42 INFO - PROCESS | 15448 | Values: 578.2 581.6 589.8 592.0 593.6 36347.8 37436.6 37744.2 41929.8 42156.4 39174.6 39581.0 39685.8 39745.2 39764.8 7211.6 7435.8 7468.9 7636.3 7642.0 9589.7 9900.1 9906.2 10194.7 10246.5 9881.8 9952.0 9954.4 9958.0 9968.2 9756.5 9810.4 9920.5 9926.0 9929.5 9642.2 9754.8 9755.3 9758.1 9758.4 37029.3 37332.6 37335.3 37380.1 37416.4 2940.3 3314.1 3315.6 3518.3 3599.9 27778.2 27883.2 27977.2 28422.1 28487.9 3447.3 3497.2 3565.7 3623.2 3689.9 248263.0 248978.0 250089.0 250667.0 251143.0 48752.3 48938.3 49117.3 49188.0 49208.3 47020.5 47025.8 47026.3 47064.3 47142.8 11031.2 11123.9 11130.4 11138.6 11139.3 8443.4 8653.9 8672.2 8674.0 9750.9 13186.1 14191.6 14672.3 14726.2 15226.6 5715.8 5743.3 5778.8 5859.8 5904.3 730.5 752.1 766.7 773.7 863.2 26598.3 26704.5 27123.3 27193.0 27244.0 906.7 919.4 928.5 982.6 986.5 14118.9 14393.0 14430.5 14656.4 14722.9 357423.0 359229.0 359879.0 361358.0 363141.0 46997.1 47003.3 47050.8 47168.5 47175.3 1097.8 1155.6 1156.2 1157.1 1160.0 25412.7 26155.0 26569.9 26969.9 27141.6 36036.6 36195.8 36211.0 36220.5 36334.8 318086.0 319346.0 320055.0 320949.0 321234.0 34058.8 34832.7 35089.8 35101.8 35134.5 38253.8 38813.0 38935.2 39500.4 40064.0 33382.0 33902.8 33935.3 34079.7 34169.8 33410.7 33695.8 33946.5 34162.5 34401.7 33500.3 34016.1 34037.0 34355.0 34369.3 30519.2 30952.2 31198.5 34406.0 34454.8 24263.3 24434.4 24436.8 24882.9 24912.3 23:30:42 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | [#2] jquery.html Cycles:180 Average:23146.25 Median:4822.98 stddev:61800.44 (1281.4%) stddev-sans-first:61950.07 23:30:42 INFO - PROCESS | 15448 | Values: 333.0 343.3 358.8 359.7 371.6 12663.0 15600.8 15811.2 15890.0 16549.6 15762.1 16147.8 16494.1 16624.0 16723.6 4815.7 4830.2 4908.3 4943.6 5055.1 3614.9 3828.9 4876.9 4956.2 4956.8 5482.9 5748.2 5765.5 5854.3 5861.5 5630.9 5743.0 5783.8 5834.3 5835.5 5114.9 5126.4 5135.9 5139.0 5139.3 18655.5 19757.2 19902.3 20018.1 20053.5 1873.8 1883.2 1912.0 1922.3 1925.2 12690.5 12697.7 12765.4 12967.5 13041.3 1635.2 1645.0 1676.4 1728.2 1752.2 43401.0 57298.7 60311.0 67226.0 70913.0 8966.8 9115.2 9194.6 9279.8 9306.5 12961.2 12985.0 12989.7 12999.5 13006.7 6803.4 6828.4 6992.5 7001.0 7076.6 6233.2 6310.4 6398.6 6580.9 6601.8 5696.6 5906.8 5927.3 5932.1 6007.7 1601.3 1683.9 1708.6 1712.8 1743.9 707.7 810.4 843.2 863.4 983.1 15904.7 16484.9 16900.5 17201.4 17345.8 822.8 844.5 849.6 865.6 902.0 9097.0 9812.7 9813.5 9845.4 9882.2 361512.0 362267.0 383874.0 384355.0 388059.0 64777.0 66611.3 67519.0 68566.7 69828.7 886.1 894.4 911.3 920.1 931.3 14409.4 14637.9 15219.5 15419.3 15437.6 34826.0 34900.0 36255.6 36530.8 36677.8 45837.3 46003.8 46088.3 46283.8 48074.0 7179.2 7257.3 7467.9 7564.0 7792.7 11080.4 11275.8 11505.4 12044.4 12156.7 9898.4 9928.5 10179.8 10235.2 10486.4 9983.2 10090.3 10138.8 10172.4 10579.4 9462.0 9531.6 10062.6 10156.7 10522.2 6470.8 6855.2 7392.3 7423.4 7586.9 8756.5 9892.3 9897.2 10344.8 10439.7 23:30:42 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | [#3] mootools.html Cycles:180 Average:4586.30 Median:4940.92 stddev:2411.72 (48.8%) stddev-sans-first:2405.85 23:30:42 INFO - PROCESS | 15448 | Values: 1301.7 1330.4 1367.8 1591.0 1608.2 5901.5 6087.6 6606.6 6987.4 6989.6 6513.8 6792.4 6794.0 6955.1 6971.0 2056.8 2090.8 2093.2 2093.5 2094.4 2050.8 2097.0 2105.4 2110.7 2112.0 2002.7 2009.0 2017.8 2019.5 2020.0 1993.6 2011.1 2011.8 2012.3 2016.1 1741.7 1809.0 2009.3 2013.1 2073.3 6594.7 6796.6 6811.2 6953.0 6957.3 4134.3 4249.2 4276.6 4277.6 4279.7 2667.3 2734.2 2805.0 2809.9 2817.5 844.8 849.9 857.8 866.7 886.0 9144.0 9151.3 9158.2 9158.6 9176.7 3883.8 3965.6 4077.6 4103.2 4108.6 7896.9 7910.4 7913.4 7914.5 7928.6 4420.4 4429.9 4431.8 4433.1 4433.5 3948.4 3987.2 4062.7 4065.6 4067.3 3354.8 3384.9 3491.7 3501.3 3516.7 1123.5 1130.1 1133.9 1137.3 1143.5 779.9 813.7 815.9 817.8 819.5 4776.8 4883.4 4974.5 4994.1 5054.6 400.7 401.5 402.7 404.9 404.9 3312.9 3399.4 3412.7 3438.9 3555.1 7000.1 7329.1 7337.1 7829.9 8108.8 7509.5 7515.7 7727.6 7976.6 8040.2 6371.1 6402.6 6506.2 6546.0 6585.6 4839.9 4842.0 4867.4 4907.4 5010.8 7529.4 7552.6 7557.1 7623.9 7628.1 7442.7 7620.3 7712.8 7770.3 7805.5 6405.1 6678.6 6681.7 6693.4 6701.3 6646.6 6651.0 6663.8 6674.8 6721.1 5903.0 5949.9 6035.6 6110.6 6157.4 5832.1 5964.6 5971.4 5990.9 6010.9 5633.3 5819.2 5885.7 5893.9 5917.2 4150.5 4254.5 4331.6 4339.7 4486.6 4413.5 4419.8 4429.2 4563.9 4569.5 23:30:42 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | [#4] prototype.html Cycles:180 Average:4104.52 Median:4679.42 stddev:1177.98 (25.2%) stddev-sans-first:1146.02 23:30:42 INFO - PROCESS | 15448 | Values: 293.2 297.4 304.2 306.6 307.3 4792.6 4850.7 4856.7 4861.2 4875.3 4730.5 4742.9 4774.7 4776.2 4806.5 3541.8 3592.2 3649.9 3664.3 3754.8 3703.4 3710.8 3736.4 3741.1 3746.0 3690.5 3701.7 3708.7 3726.3 3766.1 3563.2 3588.3 3654.1 3701.7 3735.8 3309.0 3309.1 3310.3 3311.5 3323.8 4616.0 4618.4 4620.9 4622.1 4628.7 4089.4 4276.4 4280.0 4283.2 4288.2 4910.5 4917.6 4930.6 4938.4 4961.7 3622.9 3642.2 3658.4 3669.8 3671.7 5019.9 5186.1 5188.9 5193.7 5194.7 3682.1 3703.8 3708.6 3718.3 3720.3 3719.3 3729.2 3748.3 3753.6 3764.9 4213.8 4217.1 4222.1 4222.7 4242.8 4847.5 4903.6 4940.5 4985.4 4992.9 1256.6 1258.5 1260.3 1261.7 1265.1 818.7 835.7 874.8 880.9 884.3 4175.2 4304.2 4427.3 4442.8 4455.2 5147.1 5154.6 5162.3 5165.8 5167.8 4444.2 4448.4 4452.5 4475.1 4475.4 2488.4 2653.1 2659.3 2669.0 2669.1 4680.3 4700.2 4714.3 4716.6 4728.3 4852.0 5099.8 5116.4 5127.5 5135.4 4675.0 4702.8 4708.9 4709.7 4709.9 4990.4 5004.0 5004.6 5013.8 5036.8 4648.6 4888.0 4904.4 4904.6 4908.2 4619.4 4644.9 4667.4 4678.5 4687.5 3487.9 3506.6 3524.8 3531.9 3558.8 5002.9 5005.5 5016.4 5017.6 5024.4 4682.9 4795.9 4797.6 4866.3 4868.0 4838.3 4842.8 4845.3 4850.5 4852.5 4758.4 4769.5 4769.5 4776.3 4817.2 4745.0 4885.6 5018.2 5038.0 5039.7 4926.4 4938.9 4959.4 4978.6 4979.8 23:30:42 INFO - PROCESS | 15448 | 23:30:42 INFO - PROCESS | 15448 | [#5] yui.html Cycles:180 Average:15448.00 Median:24189.84 stddev:19912.03 (82.3%) stddev-sans-first:19936.58 23:30:42 INFO - PROCESS | 15448 | Values: 579.4 652.8 709.8 713.0 741.5 12630.1 13459.7 13512.3 13533.8 13536.5 12798.9 12908.1 12945.7 12946.9 12950.9 599.6 616.0 729.8 733.9 754.2 747.7 750.0 750.1 750.1 752.0 790.5 790.7 790.8 790.8 791.2 638.1 653.7 654.6 657.2 791.0 557.6 569.1 571.8 575.1 576.4 12901.4 12926.7 12951.9 12992.9 13040.6 12263.3 12323.8 12366.9 12515.6 12705.9 11300.4 11344.7 11376.8 11457.9 11597.9 3815.6 3842.3 3856.4 3888.5 3894.7 63348.0 63920.7 64064.0 65890.3 66198.0 9960.4 10047.1 10102.3 10153.7 10233.1 18790.2 18939.3 18949.7 18957.6 18961.2 6539.3 6564.7 6619.7 6812.8 6840.3 3485.3 3542.2 3594.0 3625.7 3651.3 2764.1 2848.9 2863.3 2864.5 2872.0 482.9 486.7 492.0 492.7 539.6 566.3 597.7 607.8 621.5 622.3 8148.6 8218.4 8447.9 8495.7 8501.0 524.6 550.3 599.5 600.3 606.2 3670.4 3912.2 3926.2 3959.6 4003.0 71622.3 73251.0 74087.0 76165.0 76464.0 50190.0 60738.7 61766.1 63580.0 64090.4 56794.4 57407.0 57428.4 57937.4 59514.1 7511.5 7617.5 7736.1 7788.7 8096.0 33029.2 33650.7 33988.5 37011.0 40828.0 47402.5 47896.8 49419.8 49755.8 51041.0 10746.8 11075.4 11135.0 11211.5 11274.7 12292.8 12407.1 12524.7 13051.8 13113.7 11265.8 11531.7 11791.4 12183.1 13185.7 11504.8 11891.0 12301.9 12302.9 12304.3 11137.8 11440.4 11713.6 12350.9 12355.8 9151.4 9301.7 9644.8 9958.5 10323.2 9511.7 10293.2 10451.6 10521.6 10536.7 23:30:42 INFO - PROCESS | 15448 | -------- Summary: end -------- 23:30:42 INFO - PROCESS | 15448 | 23:30:43 INFO - TEST-INFO | 15448: exit 0 23:30:43 INFO - TEST-OK | dromaeo_css | took 1124137ms 23:30:43 INFO - TEST-START | kraken 23:30:43 INFO - operating with platform_type : linux_ 23:30:43 INFO - Initialising browser for kraken test... 23:30:43 INFO - TEST-INFO | started process 15758 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEEZJd5/profile http://localhost:56715/getInfo.html) 23:30:48 INFO - PROCESS | 15758 | __metrics Screen width/height:1600/1200 23:30:48 INFO - PROCESS | 15758 | colorDepth:24 23:30:48 INFO - PROCESS | 15758 | Browser inner width/height: 1024/697 23:30:48 INFO - PROCESS | 15758 | __metrics 23:30:48 INFO - PROCESS | 15758 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 23:30:48 INFO - PROCESS | 15758 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 23:30:49 INFO - PROCESS | 15758 | console.error: PushService: 23:30:49 INFO - PROCESS | 15758 | stateChangeProcessEnqueue: Error transitioning state 23:30:49 INFO - PROCESS | 15758 | UnknownError 23:30:50 INFO - TEST-INFO | 15758: exit 0 23:30:50 INFO - Browser initialized. 23:30:50 INFO - Running cycle 1/1 for kraken test... 23:30:50 INFO - TEST-INFO | started process 15841 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEEZJd5/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:31:03 INFO - PROCESS | 15841 | RSS: Main: 173395968 23:31:03 INFO - PROCESS | 15841 | 23:31:05 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:56715/tests/kraken/driver.html?testName=audio-beat-detection) 23:31:06 INFO - PROCESS | 15841 | RSS: Main: 235896832 23:31:06 INFO - PROCESS | 15841 | 23:31:09 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:56715/tests/kraken/driver.html?testName=audio-dft) 23:31:10 INFO - PROCESS | 15841 | RSS: Main: 217927680 23:31:10 INFO - PROCESS | 15841 | 23:31:13 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:56715/tests/kraken/driver.html?testName=audio-fft) 23:31:13 INFO - PROCESS | 15841 | RSS: Main: 300548096 23:31:13 INFO - PROCESS | 15841 | 23:31:16 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:56715/tests/kraken/driver.html?testName=audio-oscillator) 23:31:16 INFO - PROCESS | 15841 | RSS: Main: 211378176 23:31:16 INFO - PROCESS | 15841 | 23:31:18 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:56715/tests/kraken/driver.html?testName=imaging-gaussian-blur) 23:31:19 INFO - PROCESS | 15841 | RSS: Main: 214802432 23:31:19 INFO - PROCESS | 15841 | 23:31:22 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:56715/tests/kraken/driver.html?testName=imaging-darkroom) 23:31:23 INFO - PROCESS | 15841 | RSS: Main: 254083072 23:31:23 INFO - PROCESS | 15841 | 23:31:26 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:56715/tests/kraken/driver.html?testName=imaging-desaturate) 23:31:27 INFO - PROCESS | 15841 | RSS: Main: 248193024 23:31:27 INFO - PROCESS | 15841 | 23:31:30 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:56715/tests/kraken/driver.html?testName=json-parse-financial) 23:31:30 INFO - PROCESS | 15841 | RSS: Main: 249962496 23:31:30 INFO - PROCESS | 15841 | 23:31:32 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:56715/tests/kraken/driver.html?testName=json-stringify-tinderbox) 23:31:33 INFO - PROCESS | 15841 | RSS: Main: 213258240 23:31:33 INFO - PROCESS | 15841 | 23:31:35 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:56715/tests/kraken/driver.html?testName=stanford-crypto-aes) 23:31:35 INFO - PROCESS | 15841 | RSS: Main: 221327360 23:31:35 INFO - PROCESS | 15841 | 23:31:37 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:56715/tests/kraken/driver.html?testName=stanford-crypto-ccm) 23:31:38 INFO - PROCESS | 15841 | RSS: Main: 229445632 23:31:38 INFO - PROCESS | 15841 | 23:31:41 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:56715/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 23:31:42 INFO - PROCESS | 15841 | RSS: Main: 237854720 23:31:42 INFO - PROCESS | 15841 | 23:31:45 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:56715/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 23:31:45 INFO - PROCESS | 15841 | RSS: Main: 234795008 23:31:45 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | Cycle 1(1): loaded http://localhost:56715/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:56715/tests/kraken/driver.html?testName=ai-astar) 23:31:47 INFO - PROCESS | 15841 | RSS: Main: 285569024 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | __start_tp_report 23:31:47 INFO - PROCESS | 15841 | _x_x_mozilla_page_load 23:31:47 INFO - PROCESS | 15841 | _x_x_mozilla_page_load_details 23:31:47 INFO - PROCESS | 15841 | |i|pagename|runs| 23:31:47 INFO - PROCESS | 15841 | |0;ai-astar;112;114;113;113;113;113;113;114;114;114 23:31:47 INFO - PROCESS | 15841 | |1;audio-beat-detection;151;131;132;172;130;133;132;134;159;131 23:31:47 INFO - PROCESS | 15841 | |2;audio-dft;161;162;162;162;161;162;162;161;162;162 23:31:47 INFO - PROCESS | 15841 | |3;audio-fft;76;80;76;116;77;76;78;76;100;76 23:31:47 INFO - PROCESS | 15841 | |4;audio-oscillator;83;83;116;83;84;83;107;83;83;105 23:31:47 INFO - PROCESS | 15841 | |5;imaging-gaussian-blur;117;117;116;117;117;117;117;117;118;118 23:31:47 INFO - PROCESS | 15841 | |6;imaging-darkroom;147;146;146;146;146;147;146;146;146;146 23:31:47 INFO - PROCESS | 15841 | |7;imaging-desaturate;95;95;95;96;95;95;96;95;95;95 23:31:47 INFO - PROCESS | 15841 | |8;json-parse-financial;65;64;65;64;64;66;65;72;65;65 23:31:47 INFO - PROCESS | 15841 | |9;json-stringify-tinderbox;66;65;65;65;65;64;66;67;66;66 23:31:47 INFO - PROCESS | 15841 | |10;stanford-crypto-aes;85;93;85;87;85;84;85;84;86;85 23:31:47 INFO - PROCESS | 15841 | |11;stanford-crypto-ccm;145;144;146;147;142;152;142;143;185;157 23:31:47 INFO - PROCESS | 15841 | |12;stanford-crypto-pbkdf2;181;188;187;181;184;183;185;178;186;179 23:31:47 INFO - PROCESS | 15841 | |13;stanford-crypto-sha256-iterative;71;71;70;70;72;77;71;72;70;73 23:31:47 INFO - PROCESS | 15841 | __end_tp_report 23:31:47 INFO - PROCESS | 15841 | __start_cc_report 23:31:47 INFO - PROCESS | 15841 | _x_x_mozilla_cycle_collect,1908 23:31:47 INFO - PROCESS | 15841 | __end_cc_report 23:31:47 INFO - PROCESS | 15841 | __startTimestamp1480750307867__endTimestamp 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | ------- Summary: start ------- 23:31:47 INFO - PROCESS | 15841 | Number of tests: 14 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#0] ai-astar Cycles:10 Average:113.30 Median:113.50 stddev:0.67 (0.6%) stddev-sans-first:0.53 23:31:47 INFO - PROCESS | 15841 | Values: 112.0 114.0 113.0 113.0 113.0 113.0 113.0 114.0 114.0 114.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#1] audio-beat-detection Cycles:10 Average:140.50 Median:133.50 stddev:14.83 (11.1%) stddev-sans-first:15.23 23:31:47 INFO - PROCESS | 15841 | Values: 151.0 131.0 132.0 172.0 130.0 133.0 132.0 134.0 159.0 131.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#2] audio-dft Cycles:10 Average:161.70 Median:162.00 stddev:0.48 (0.3%) stddev-sans-first:0.44 23:31:47 INFO - PROCESS | 15841 | Values: 161.0 162.0 162.0 162.0 161.0 162.0 162.0 161.0 162.0 162.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#3] audio-fft Cycles:10 Average:83.10 Median:76.00 stddev:13.71 (18.0%) stddev-sans-first:14.30 23:31:47 INFO - PROCESS | 15841 | Values: 76.0 80.0 76.0 116.0 77.0 76.0 78.0 76.0 100.0 76.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#4] audio-oscillator Cycles:10 Average:91.00 Median:83.00 stddev:12.95 (15.6%) stddev-sans-first:13.41 23:31:47 INFO - PROCESS | 15841 | Values: 83.0 83.0 116.0 83.0 84.0 83.0 107.0 83.0 83.0 105.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#5] imaging-gaussian-blur Cycles:10 Average:117.10 Median:117.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 23:31:47 INFO - PROCESS | 15841 | Values: 117.0 117.0 116.0 117.0 117.0 117.0 117.0 117.0 118.0 118.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:146.00 stddev:0.42 (0.3%) stddev-sans-first:0.33 23:31:47 INFO - PROCESS | 15841 | Values: 147.0 146.0 146.0 146.0 146.0 147.0 146.0 146.0 146.0 146.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 23:31:47 INFO - PROCESS | 15841 | Values: 95.0 95.0 95.0 96.0 95.0 95.0 96.0 95.0 95.0 95.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#8] json-parse-financial Cycles:10 Average:65.50 Median:65.00 stddev:2.37 (3.6%) stddev-sans-first:2.51 23:31:47 INFO - PROCESS | 15841 | Values: 65.0 64.0 65.0 64.0 64.0 66.0 65.0 72.0 65.0 65.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#9] json-stringify-tinderbox Cycles:10 Average:65.50 Median:66.00 stddev:0.85 (1.3%) stddev-sans-first:0.88 23:31:47 INFO - PROCESS | 15841 | Values: 66.0 65.0 65.0 65.0 65.0 64.0 66.0 67.0 66.0 66.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#10] stanford-crypto-aes Cycles:10 Average:85.90 Median:85.00 stddev:2.64 (3.1%) stddev-sans-first:2.78 23:31:47 INFO - PROCESS | 15841 | Values: 85.0 93.0 85.0 87.0 85.0 84.0 85.0 84.0 86.0 85.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#11] stanford-crypto-ccm Cycles:10 Average:150.30 Median:146.50 stddev:13.08 (8.9%) stddev-sans-first:13.73 23:31:47 INFO - PROCESS | 15841 | Values: 145.0 144.0 146.0 147.0 142.0 152.0 142.0 143.0 185.0 157.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:183.20 Median:184.50 stddev:3.39 (1.8%) stddev-sans-first:3.50 23:31:47 INFO - PROCESS | 15841 | Values: 181.0 188.0 187.0 181.0 184.0 183.0 185.0 178.0 186.0 179.0 23:31:47 INFO - PROCESS | 15841 | 23:31:47 INFO - PROCESS | 15841 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.70 Median:71.50 stddev:2.11 (3.0%) stddev-sans-first:2.22 23:31:47 INFO - PROCESS | 15841 | Values: 71.0 71.0 70.0 70.0 72.0 77.0 71.0 72.0 70.0 73.0 23:31:47 INFO - PROCESS | 15841 | -------- Summary: end -------- 23:31:47 INFO - PROCESS | 15841 | 23:31:49 INFO - TEST-INFO | 15841: exit 0 23:31:49 INFO - TEST-OK | kraken | took 65837ms 23:31:49 INFO - SUITE-END | took 1189s 23:31:49 INFO - Completed test suite (00:19:50) 23:31:49 INFO - javascript benchmark 23:31:49 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2572.562664347061, 2584.625229341745, 2594.4940736556355, 2606.400527878588, 2619.4237267801077, 4431.357453169288, 4496.190685676577, 4586.885327866801, 4601.378813860128, 4614.054118905625, 4532.388127602772, 4634.258518637019, 4673.29900514923, 4701.083288758685, 4731.408573928259, 4198.8530401435955, 4208.137331846964, 4249.915001699964, 4291.442112525383, 4358.324459708734, 3887.403318094256, 4191.895202619929, 4276.315789473685, 4325.848595299165, 4365.279728844736, 4126.42230087788, 4144.564820693814, 4288.9785551072355, 4345.826166953318, 4361.171377438277, 4187.309093999486, 4219.7046206765535, 4254.340577210537, 4270.530241673445, 4320.719153255029, 4258.127083947814, 4259.957400425987, 4260.360945858115, 4264.0, 4303.763293018883, 4633.536646335373, 4673.953260467386, 4682.695624784378, 4699.765011749433, 4717.646176536773, 4822.95177048232, 4868.196747536652, 4868.78090485929, 4893.584045356149, 4896.583790377822, 4979.0, 4979.850604481871, 4987.401511818605, 5011.3485246918035, 5024.447310795809, 4651.37206477128, 4653.488116307203, 4654.86035418938, 4656.511066338054, 4693.6949098308505, 4924.655274130848, 4960.107180707508, 4961.2806143109765, 5062.139436295838, 5117.744112794346, 4819.2530157825595, 4827.975860120677, 4829.806807727722, 4851.854444366674, 4899.853004409873, 4913.533214344631, 4928.433230178503, 4936.802527898915, 4955.4301255356095, 4978.2034874419915, 4839.782209800567, 4883.047805677858, 4909.558139767367, 4913.680610760289, 4959.876003099951, 4840.298156767249, 4883.633727470454, 4884.804607815719, 4891.0, 4894.388201474816, 4131.0, 4159.022629682022, 4159.272127377757, 4160.9375859362135, 4177.143685544456, 3642.4900513928073, 3649.872254471081, 3651.72612054097, 3683.613220611851, 3692.8892133236045, 4175.185838761412, 4290.549492303326, 4290.678199135077, 4299.441072660534, 4344.044310251803, 4839.0, 4908.803647854117, 4925.507449255046, 4951.306817045616, 4966.478519755446, 4307.375430562551, 4308.18144552534, 4343.283358245917, 4344.174606824693, 4348.043430445297, 4447.221736196153, 4454.22051141049, 4456.821727130879, 4494.640428765691, 4501.617362524156, 4536.75047872357, 4629.837955671535, 4702.106599746037, 4702.976485117552, 4706.458757242961, 4912.1158191525865, 4920.45874953762, 4927.457979622167, 4931.580815630711, 4966.428860681068, 4675.766211689333, 4678.60231880294, 4683.531646835289, 4686.4610569783545, 4692.366530518473, 4899.216125419915, 4975.402951645826, 4979.775910084128, 4981.327520784647, 4991.3511243538105, 4985.601151907911, 4994.325766021686, 4995.350604421547, 4999.225120106389, 5040.798368065236, 4817.084753896748, 4867.464578896389, 4868.878278043077, 4871.098846713369, 4910.337104490848, 4632.096741135446, 4658.440987081572, 4678.883027924329, 4713.0, 4714.010057887745, 4635.559621835921, 4636.6058884995155, 4638.768061596839, 4645.256758918556, 4699.365585645894, 4825.541573550507, 4842.128416884994, 4892.3884514435695, 4913.263010548446, 4915.7542122893, 4578.2903649934315, 4590.311453282035, 4765.285207218806, 4774.856754297377, 4819.783109759999], "value": 4535.628700370384, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [578.228065532514, 581.5522048023021, 589.775885163638, 591.9965658209337, 593.5607650338748, 36347.818260908694, 37436.62563374366, 37744.245115097685, 41929.7903510482, 42156.367654485206, 39174.60825391745, 39581.0, 39685.8015709921, 39745.20509589806, 39764.80117599415, 7211.603361815098, 7435.7769266921805, 7468.850622987537, 7636.312731854132, 7642.04474440695, 9589.664361747306, 9900.108990190882, 9906.207503399746, 10194.6941591752, 10246.48767561619, 9881.802363952716, 9952.0, 9954.402735835836, 9958.0, 9968.202543796478, 9756.4633945133, 9810.362326448794, 9920.503974801231, 9926.0, 9929.453880036595, 9642.228621710246, 9754.756131096708, 9755.317127801056, 9758.121769040821, 9758.414495130244, 37029.25941481182, 37332.62667373319, 37335.25329493422, 37380.065498362485, 37416.43875341872, 2940.3237255431372, 3314.121757734202, 3315.61870384904, 3518.296340731864, 3599.94600080999, 27778.166655000383, 27883.16350509488, 27977.16068517948, 28422.147335579964, 28487.85756071227, 3447.293304872495, 3497.178163131662, 3565.6790888820133, 3623.184783423735, 3689.889303320878, 248263.0, 248978.0, 250089.0, 250666.99999999817, 251143.0, 48752.26871596929, 48938.26592601114, 49117.26324105141, 49188.0, 49208.26187607189, 47020.5297947023, 47025.76487117542, 47026.294605580944, 47064.2940355895, 47142.764286178346, 11031.22781405294, 11123.888761112285, 11130.443477826077, 11138.554457821758, 11139.275947063416, 8443.408961372645, 8653.870191947126, 8672.176143266379, 8673.956630216808, 9750.853737193947, 13186.076974611877, 14191.645208869655, 14672.266386680623, 14726.190059546614, 15226.619334516725, 5715.771369145271, 5743.3395159557185, 5778.8266352009505, 5859.794907178313, 5904.321003084614, 730.5142080516504, 752.1237758011855, 766.7124828189429, 773.6982576795054, 863.2230992107028, 26598.335041624116, 26704.465910681676, 27123.321916952234, 27193.0, 27244.0, 906.655470921059, 919.3518569408551, 928.5078908178676, 982.6020461713018, 986.4919566423298, 14118.929405353112, 14393.0, 14430.494932677306, 14656.435123853284, 14722.852771472362, 357422.98039137013, 359229.0, 359879.0, 361358.0, 363141.0, 46997.06005879932, 47003.29495057577, 47050.764746176734, 47168.5283147171, 47175.292370614465, 1097.8463015177722, 1155.595541560464, 1156.1560061155571, 1157.1032449851264, 1159.976800463986, 25412.74587254104, 26155.0, 26569.937202511683, 26969.865150674123, 27141.59287610727, 36036.63963360333, 36195.819020904724, 36211.0, 36220.456693150154, 36334.81832590926, 318086.0, 319346.0, 320055.0, 320949.0, 321234.0, 34058.82970585131, 34832.65167348395, 35089.824550877085, 35101.824490877385, 35134.472982904765, 38253.80873095617, 38813.0, 38935.24791384338, 39500.40749388704, 40064.0, 33382.0, 33902.762154730655, 33935.32129357448, 34079.659203407646, 34169.829150854086, 33410.66589334173, 33695.831520842235, 33946.49080263748, 34162.48756268708, 34401.65598344085, 33500.32999340048, 34016.14959626029, 34037.0, 34355.0, 34369.31261374809, 30519.237019074702, 30952.22619434442, 31198.488840284157, 34406.0, 34454.82772586221, 24263.272101836974, 24434.389140271636, 24436.755632444158, 24882.875585621958, 24912.252632421056], "value": 17160.400819925988, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [333.03420081762897, 343.2825394924607, 358.8259694048387, 359.696056831977, 371.6487918916625, 12663.0, 15600.765988510182, 15811.209439528035, 15890.0, 16549.58626034347, 15762.054276743404, 16147.838521614809, 16494.092824894626, 16624.0, 16723.581910452245, 4815.735134567597, 4830.227163653825, 4908.263760435928, 4943.604511639061, 5055.115354812911, 3614.8554057837787, 3828.885133446001, 4876.926846097312, 4956.1822299320565, 4956.826511072113, 5482.890342193174, 5748.223989761371, 5765.538756899438, 5854.268216472941, 5861.472467477947, 5630.887382252373, 5742.97128514359, 5783.797567085132, 5834.299884013924, 5835.533157347402, 5114.872128196787, 5126.359205099363, 5135.948640513584, 5138.997895410396, 5139.254808052849, 18655.53361165968, 19757.20971161152, 19902.303419380252, 20018.09918553654, 20053.498662533406, 1873.7657792775904, 1883.2372888979985, 1912.0439780109946, 1922.3367938061485, 1925.1914196037699, 12690.492380304777, 12697.746045079046, 12765.36173191346, 12967.481300748053, 13041.347932603332, 1635.2069246415479, 1645.0039605637503, 1676.4300137953032, 1728.2309372329319, 1752.1502071495315, 43401.03552365916, 57298.7135064322, 60311.0, 67226.0, 70912.99999999949, 8966.820663586692, 9115.179633832988, 9194.586243619053, 9279.768005799773, 9306.488143152057, 12961.15752476086, 12985.02612304081, 12989.740205196033, 12999.545015924397, 13006.674833129247, 6803.421709154777, 6828.419584335288, 6992.545484543489, 7000.964995174992, 7076.610786406797, 6233.158523599347, 6310.368963103745, 6398.584092034003, 6580.934190658128, 6601.844677181474, 5696.629719068247, 5906.7637294508595, 5927.347991720907, 5932.110183472513, 6007.699615019319, 1601.279424259088, 1683.8905471144337, 1708.5643160993866, 1712.8372804583544, 1743.9302427902996, 707.706301884712, 810.4003037752021, 843.2031730015077, 863.4215075899162, 983.1397527163732, 15904.681906361808, 16484.917575412048, 16900.492985210465, 17201.44633216088, 17345.826541734423, 822.8313195794848, 844.4806444036873, 849.6389034660244, 865.6148014133776, 902.0, 9096.954515227382, 9812.705618831447, 9813.509324533745, 9845.360051596623, 9882.209423246122, 361512.0, 362267.0, 383874.0, 384355.0, 388059.0, 64777.0, 66611.33388666052, 67519.0, 68566.65716671385, 69828.65085674539, 886.082904194156, 894.4096896048577, 911.3210658059788, 920.130476699526, 931.2549960031947, 14409.414964353704, 14637.926810366305, 15219.543413697607, 15419.306131223897, 15437.614059648598, 34826.0, 34900.0, 36255.63744362522, 36530.8173459131, 36677.81661091677, 45837.31244031409, 46003.76998114988, 46088.308675370565, 46283.76858115688, 48074.0, 7179.246179151322, 7257.274272572911, 7467.887981680171, 7564.0, 7792.688292468464, 11080.39057851826, 11275.830862536905, 11505.367204803817, 12044.397780110785, 12156.696082598006, 9898.356606820533, 9928.453935033642, 10179.847302290324, 10235.232357573062, 10486.423246721199, 9983.15143212806, 10090.293679442368, 10138.79722405533, 10172.389656620626, 10579.36523808574, 9461.95269023678, 9531.571079301586, 10062.647807326708, 10156.746081348025, 10522.158227341948, 6470.773522926675, 6855.177378714586, 7392.334689877722, 7423.406127509894, 7586.924130758622, 8756.51839148853, 9892.258080644124, 9897.158741507052, 10344.844827327746, 10439.739006524595], "value": 8022.666630375597, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1301.7266374061446, 1330.3880215101055, 1367.84269808972, 1591.0, 1608.1717915273643, 5901.527877769779, 6087.573869829113, 6606.570572912758, 6987.441004719623, 6989.615571143591, 6513.8371540711505, 6792.354726301006, 6794.014867844159, 6955.061066755987, 6971.024056632075, 2056.845736569752, 2090.8118269355755, 2093.173196587347, 2093.518490747129, 2094.392626138418, 2050.76416212136, 2096.9790302096935, 2105.3999610111123, 2110.7467103947547, 2112.0, 2002.6795712685973, 2008.9899550502228, 2017.788132246115, 2019.545602239499, 2019.9899000504977, 1993.601279744057, 2011.095007246745, 2011.8088781565727, 2012.2956965062258, 2016.0927582587747, 1741.6952033394105, 1808.9909550452296, 2009.3168322770182, 2013.134352228541, 2073.2743539761113, 6594.703238354237, 6796.626185559792, 6811.2167100783545, 6953.0, 6957.304269573002, 4134.338505839051, 4249.150169966019, 4276.636485898703, 4277.636400905927, 4279.700420970534, 2667.346500107486, 2734.248081777507, 2805.0, 2809.90165344212, 2817.5351067073907, 844.846784139651, 849.8640217565222, 857.7726902370877, 866.7443104284251, 886.0120965123905, 9143.954280228623, 9151.267898568165, 9158.221551168159, 9158.633654653806, 9176.724698259062, 3883.76697398157, 3965.643092121723, 4077.6136113721477, 4103.220388126247, 4108.589141085928, 7896.921030789618, 7910.446268761247, 7913.406494512935, 7914.485558438683, 7928.643211055516, 4420.3590479380955, 4429.933550996738, 4431.822727090945, 4433.069055498317, 4433.534478879671, 3948.4077388391397, 3987.2424239394422, 4062.73592216505, 4065.6137666921595, 4067.2678917795083, 3354.798712077283, 3384.8646054157557, 3491.738119641037, 3501.2647344057523, 3516.701080408194, 1123.5056575106926, 1130.141092769501, 1133.8866113388594, 1137.294877176156, 1143.4740019591081, 779.8869163971192, 813.7233340664203, 815.8816971539212, 817.7546735979182, 819.4837252530867, 4776.808927642925, 4883.365162528919, 4974.477679843637, 4994.076095922266, 5054.616833072766, 400.71949635255436, 401.45602708330375, 402.7080366734094, 404.9047326980511, 404.92104039712564, 3312.8840490582716, 3399.4220982433044, 3412.744044196695, 3438.914027149341, 3555.0579096539436, 7000.124984376953, 7329.083864516935, 7337.0828646419195, 7829.921700783033, 8108.756737297773, 7509.51188172767, 7515.661795219228, 7727.613619319011, 7976.601169941479, 8040.195980401913, 6371.108044873721, 6402.647854368054, 6506.154199953976, 6546.0, 6585.571937824122, 4839.903201935871, 4841.95158048415, 4867.395943170387, 4907.3620429343955, 5010.799568017239, 7529.397648188241, 7552.584607846621, 7557.05536807899, 7623.923760762544, 7628.084629844454, 7442.665080071301, 7620.31417172435, 7712.807179820325, 7770.261825126604, 7805.4536182468955, 6405.135306733531, 6678.599284042973, 6681.732730690718, 6693.397594216543, 6701.296363881722, 6646.634435106115, 6651.0, 6663.800085997428, 6674.766383176566, 6721.126253587003, 5903.0, 5949.851253718519, 6035.577509574287, 6110.572259941761, 6157.3818442298225, 5832.066869300891, 5964.582479226413, 5971.373005834499, 5990.850228744316, 6010.909836352371, 5633.267675202197, 5819.243498345188, 5885.735141918538, 5893.852653683693, 5917.230760001173, 4150.543440221513, 4254.532001479896, 4331.5884990925815, 4339.674524410619, 4486.573775491323, 4413.455290648248, 4419.756913369795, 4429.15845989261, 4563.863084107482, 4569.451665800125], "value": 3713.6072248171427, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [293.1878696012045, 297.3918337000833, 304.2394014962593, 306.61213564840466, 307.32388744761516, 4792.5926296264815, 4850.720161524083, 4856.730447464505, 4861.222204447289, 4875.341828853104, 4730.526947305277, 4742.9051418971685, 4774.665773395864, 4776.235802271637, 4806.519348065201, 3541.752077354586, 3592.2456284180353, 3649.94525082124, 3664.2777894389596, 3754.793486358249, 3703.4074548072313, 3710.8330125144435, 3736.3648179809497, 3741.102135487477, 3745.9812700936595, 3690.450010995375, 3701.7408781385316, 3708.7033037356946, 3726.2859084821016, 3766.114962983697, 3563.2160924596546, 3588.282343531278, 3654.104744337641, 3701.7223708221723, 3735.8132093395493, 3309.0, 3309.12308238317, 3310.3213841162506, 3311.503274508819, 3323.833808309599, 4615.953470709315, 4618.399608050965, 4620.861374158781, 4622.14490319292, 4628.662525424639, 4089.44792453021, 4276.358546218092, 4279.97860010698, 4283.164782867342, 4288.24955632763, 4910.459849416561, 4917.582005529499, 4930.580900623451, 4938.38270216223, 4961.677490963076, 3622.8950170198077, 3642.1987162824134, 3658.378075727133, 3669.8165091745304, 3671.706263498914, 5019.874503137451, 5186.118359878792, 5188.92216616751, 5193.740312984336, 5194.740262986873, 3682.0978860178893, 3703.79629120401, 3708.5735140458655, 3718.3492888744363, 3720.311742327624, 3719.34911390511, 3729.21686445844, 3748.3253014457114, 3753.5683396409217, 3764.9058773530332, 4213.789310534522, 4217.135487225111, 4222.113356195172, 4222.746635201897, 4242.830286788494, 4847.491013443538, 4903.6077113831525, 4940.456549779521, 4985.4017517897355, 4992.925106123411, 1256.585326842158, 1258.5217617305366, 1260.3068312428127, 1261.7413430246777, 1265.1333836321965, 818.7216346442239, 835.6532039203662, 874.7987962768599, 880.8854848869606, 884.2969838978028, 4175.206710724952, 4304.225239456928, 4427.313766366218, 4442.777861106932, 4455.242608756519, 5147.124988751922, 5154.561862241677, 5162.328897243409, 5165.845024649267, 5167.793288268503, 4444.222261104358, 4448.399466072104, 4452.510223875371, 4475.082608065339, 4475.351074094238, 2488.4276616377974, 2653.1377302376804, 2659.295286749013, 2669.0391459074717, 2669.104022136004, 4680.297955306663, 4700.153972285021, 4714.279288059834, 4716.575508204278, 4728.267118596623, 4851.95148048515, 5099.821506247264, 5116.386033675983, 5127.538521533005, 5135.435102138762, 4674.976625116853, 4702.756426584334, 4708.858734237979, 4709.717416954856, 4709.929351059737, 4990.4261009982865, 5004.024215277986, 5004.649674522894, 5013.849584512471, 5036.823711170238, 4648.604868586208, 4887.999999999858, 4904.386951631046, 4904.558589726942, 4908.214685650279, 4619.353290539394, 4644.86065418038, 4667.393238878924, 4678.532146785295, 4687.531226892143, 3487.8604855805484, 3506.579210494757, 3524.8237588121006, 3531.858725650945, 3558.768680035789, 5002.899942001212, 5005.471142844359, 5016.372953380827, 5017.57350625201, 5024.397072351341, 4682.906341873211, 4795.928061079157, 4797.592204662643, 4866.274886063816, 4868.0, 4838.274258861199, 4842.782074806712, 4845.262426728887, 4850.46644869057, 4852.466228714909, 4758.384367163845, 4769.475357710579, 4769.523047695203, 4776.307435421914, 4817.205161148371, 4744.952550474451, 4885.633577481632, 5018.172001619692, 5038.0, 5039.722815245197, 4926.359573255454, 4938.851834444972, 4959.380077490314, 4978.626603004716, 4979.800807967641], "value": 3732.7898813937236, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [579.3627010288683, 652.7650045983445, 709.8154479835241, 713.040644304316, 741.4846681556314, 12630.05274604405, 13459.663508412295, 13512.256825874572, 13533.796993045113, 13536.526221582235, 12798.872011279884, 12908.096433249677, 12945.676358091052, 12946.93526532366, 12950.870491295083, 599.5922772514688, 615.9538034647397, 729.784713509516, 733.8532293541286, 754.1854796819422, 747.6971826410313, 750.0249675421957, 750.1111183247841, 750.114864459937, 751.9511231769944, 790.5454363740872, 790.7034861926777, 790.8062524681461, 790.8299715561153, 791.1771757372326, 638.1257676982564, 653.7254353171679, 654.5908806995627, 657.2376043789229, 791.0151860933117, 557.6431084106175, 569.0979797021726, 571.7627184718336, 575.0856138739424, 576.3631187537752, 12901.354932253349, 12926.676833079247, 12951.87048129516, 12992.935035324857, 13040.608781736562, 12263.26420414769, 12323.815142772866, 12366.938165309115, 12515.56195533161, 12705.936470317682, 11300.378479183642, 11344.716382090432, 11376.829347559793, 11457.88542114585, 11597.942010289895, 3815.6184381561898, 3842.2507611015862, 3856.3636999894984, 3888.4556162137324, 3894.7273690841653, 63348.0, 63920.68039659818, 64064.0, 65890.3410965889, 66198.0, 9960.402375857471, 10047.145992590566, 10102.292839501164, 10153.746156346151, 10233.079022887976, 18790.234121016394, 18939.337123200898, 18949.715754263696, 18957.620847583246, 18961.241550337832, 6539.313372095861, 6564.7374105036215, 6619.66901654925, 6812.761553345609, 6840.281770414035, 3485.2680937003006, 3542.2384187399834, 3594.0, 3625.728070394731, 3651.3427583034777, 2764.074035198191, 2848.9145325640266, 2863.3414314707315, 2864.484392809314, 2871.9712802872123, 482.9106615276185, 486.7322972365185, 491.97540122993706, 492.74869816393897, 539.5845199196675, 566.2666846433877, 597.7429705226795, 607.8449995251183, 621.4810633121394, 622.2905887288495, 8148.592570371457, 8218.383621228311, 8447.873281900776, 8495.702650407206, 8501.0, 524.5777149394773, 550.3258508327267, 599.5054080383701, 600.2616781358865, 606.1513880567153, 3670.44943258508, 3912.197999410114, 3926.1755031443718, 3959.6238357356006, 4002.959970400317, 71622.28377716156, 73251.0, 74087.0, 76165.0, 76464.0, 50190.0, 60738.696306518184, 61766.0735088974, 63580.0, 64090.359096409375, 56794.43205567892, 57407.0, 57428.425715742305, 57937.420625794046, 59514.10728839158, 7511.51175173612, 7617.5048621839405, 7736.149023607286, 7788.727394541163, 8096.0, 33029.17427064342, 33650.66349336475, 33988.49017264693, 37011.0, 40828.0, 47402.52597473981, 47896.760516197195, 49419.75290123526, 49755.75122124366, 51041.0, 10746.8387974182, 11075.446227688744, 11135.0, 11211.495482703134, 11274.661760147208, 12292.754144917231, 12407.069469789622, 12524.686882828002, 13051.804222936853, 13113.737725245252, 11265.831012534982, 11531.654050378502, 11791.35147566892, 12183.086268529718, 13185.670358241121, 11504.769904601693, 11891.0, 12301.87698123043, 12302.876971230531, 12304.323262220663, 11137.770046686694, 11440.42797860087, 11713.590024349107, 12350.876491234972, 12355.814662779885, 9151.405158664666, 9301.674441394518, 9644.807103857744, 9958.452285124387, 10323.174146068146, 9511.714648560554, 10293.228007899288, 10451.63419280352, 10521.579136834442, 10536.736581585521], "value": 6277.12438779985, "unit": "score"}], "name": "dromaeo_css", "value": 6154.43272942893, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 114.0, 113.0, 113.0, 113.0, 113.0, 113.0, 114.0, 114.0, 114.0], "value": 113.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 131.0, 132.0, 172.0, 130.0, 133.0, 132.0, 134.0, 159.0, 131.0], "value": 140.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 162.0, 162.0, 162.0, 161.0, 162.0, 162.0, 161.0, 162.0, 162.0], "value": 161.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 80.0, 76.0, 116.0, 77.0, 76.0, 78.0, 76.0, 100.0, 76.0], "value": 83.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 116.0, 83.0, 84.0, 83.0, 107.0, 83.0, 83.0, 105.0], "value": 91.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0, 117.0, 118.0, 118.0], "value": 117.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 146.0, 146.0, 146.0, 147.0, 146.0, 146.0, 146.0, 146.0], "value": 146.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 96.0, 95.0, 95.0, 96.0, 95.0, 95.0, 95.0], "value": 95.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 65.0, 64.0, 64.0, 66.0, 65.0, 72.0, 65.0, 65.0], "value": 65.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 65.0, 65.0, 65.0, 65.0, 64.0, 66.0, 67.0, 66.0, 66.0], "value": 65.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 93.0, 85.0, 87.0, 85.0, 84.0, 85.0, 84.0, 86.0, 85.0], "value": 85.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 144.0, 146.0, 147.0, 142.0, 152.0, 142.0, 143.0, 185.0, 157.0], "value": 150.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [181.0, 188.0, 187.0, 181.0, 184.0, 183.0, 185.0, 178.0, 186.0, 179.0], "value": 183.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 71.0, 70.0, 70.0, 72.0, 77.0, 71.0, 72.0, 70.0, 73.0], "value": 71.7, "unit": "score"}], "name": "kraken", "value": 1570.2000000000003, "alertThreshold": 2.0}]} 23:31:49 INFO - Return code: 0 23:31:49 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 23:31:49 INFO - # TBPL SUCCESS # 23:31:49 INFO - Running post-action listener: _resource_record_post_action 23:31:49 INFO - [mozharness: 2016-12-03 07:31:49.647672Z] Finished run-tests step (success) 23:31:49 INFO - Running post-run listener: _resource_record_post_run 23:31:49 INFO - Total resource usage - Wall time: 1206s; CPU: 13.0%; Read bytes: 4096; Write bytes: 389435392; Read time: 28; Write time: 579640 23:31:49 INFO - TinderboxPrint: CPU usage
13.1% 23:31:49 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 28 23:31:49 INFO - TinderboxPrint: I/O write bytes / time
389,435,392 / 579,640 23:31:49 INFO - TinderboxPrint: CPU idle
8,358.7 (86.9%) 23:31:49 INFO - TinderboxPrint: CPU user
1,210.0 (12.6%) 23:31:49 INFO - TinderboxPrint: Swap in / out
0 / 0 23:31:49 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 99680256; Read time: 0; Write time: 224368 23:31:49 INFO - run-tests - Wall time: 1191s; CPU: 13.0%; Read bytes: 0; Write bytes: 289755136; Read time: 0; Write time: 355272 23:31:50 INFO - Running post-run listener: _upload_blobber_files 23:31:50 INFO - Blob upload gear active. 23:31:50 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 23:31:50 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 23:31:50 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', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 23:31:50 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 Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 23:31:50 INFO - (blobuploader) - INFO - Open directory for files ... 23:31:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 23:31:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:31:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:31:54 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 23:31:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:31:54 INFO - (blobuploader) - INFO - Done attempting. 23:31:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 23:31:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:31:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:31:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 23:31:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:31:54 INFO - (blobuploader) - INFO - Done attempting. 23:31:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 23:31:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:31:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:31:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 23:31:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:31:55 INFO - (blobuploader) - INFO - Done attempting. 23:31:55 INFO - (blobuploader) - INFO - Iteration through files over. 23:31:55 INFO - Return code: 0 23:31:55 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 23:31:55 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 23:31:55 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c750b818932b0730ab6d1a628c074fd43d1cbb5737ef29a08259ced97b6984d602b80b17a48385caf08d5a71ec4b0fdbd73ea17a66cf26d50a56317d9d91e979", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/03cc3e07ec82d53ae6038e47176f6d6ae3fee8b046a81c17d748208036cbeca5db00505519b7096e47c4880ec2d98486a7dc6712701ecb53b2bec391f6ba4ec8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/1aad957df38e417e763b38e5b1024145ffd02f04fc7fe2c31848c78504e006700761f90bb5f84ce908cb6bc74edbbf69ec3dd2347efc57d61ff805c24025936b"} 23:31:55 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 23:31:55 INFO - Writing to file /builds/slave/test/properties/blobber_files 23:31:55 INFO - Contents: 23:31:55 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c750b818932b0730ab6d1a628c074fd43d1cbb5737ef29a08259ced97b6984d602b80b17a48385caf08d5a71ec4b0fdbd73ea17a66cf26d50a56317d9d91e979", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/03cc3e07ec82d53ae6038e47176f6d6ae3fee8b046a81c17d748208036cbeca5db00505519b7096e47c4880ec2d98486a7dc6712701ecb53b2bec391f6ba4ec8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/1aad957df38e417e763b38e5b1024145ffd02f04fc7fe2c31848c78504e006700761f90bb5f84ce908cb6bc74edbbf69ec3dd2347efc57d61ff805c24025936b"} 23:31:55 INFO - Running post-run listener: copy_logs_to_upload_dir 23:31:55 INFO - Copying logs to upload dir... 23:31:55 INFO - mkdir: /builds/slave/test/build/upload/logs 23:31:55 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1249.771474 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-12-02 23:31:55.011766) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-02 23:31:55.015548) ========= 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=745a4373a2a16df560f216e000000264-1480740029.331681-1467241711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c750b818932b0730ab6d1a628c074fd43d1cbb5737ef29a08259ced97b6984d602b80b17a48385caf08d5a71ec4b0fdbd73ea17a66cf26d50a56317d9d91e979", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/03cc3e07ec82d53ae6038e47176f6d6ae3fee8b046a81c17d748208036cbeca5db00505519b7096e47c4880ec2d98486a7dc6712701ecb53b2bec391f6ba4ec8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/1aad957df38e417e763b38e5b1024145ffd02f04fc7fe2c31848c78504e006700761f90bb5f84ce908cb6bc74edbbf69ec3dd2347efc57d61ff805c24025936b"} build_url:https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011420 build_url: 'https://queue.taskcluster.net/v1/task/WIx-VH2wS-SHrYDSYpj0YA/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c750b818932b0730ab6d1a628c074fd43d1cbb5737ef29a08259ced97b6984d602b80b17a48385caf08d5a71ec4b0fdbd73ea17a66cf26d50a56317d9d91e979", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/03cc3e07ec82d53ae6038e47176f6d6ae3fee8b046a81c17d748208036cbeca5db00505519b7096e47c4880ec2d98486a7dc6712701ecb53b2bec391f6ba4ec8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/1aad957df38e417e763b38e5b1024145ffd02f04fc7fe2c31848c78504e006700761f90bb5f84ce908cb6bc74edbbf69ec3dd2347efc57d61ff805c24025936b"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-02 23:31:55.042600) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-02 23:31:55.042937) ========= 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=745a4373a2a16df560f216e000000264-1480740029.331681-1467241711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004459 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-02 23:31:55.127578) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-02 23:31:55.128350) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-02 23:31:55.129022) ========= ========= Total master_lag: 0.21 =========