builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-034 starttime: 1474126402.41 results: success (0) buildid: 20160916143618 builduid: 6096345e4c47423bba4fe6e518696367 revision: f2fe5345c13ff5ec70dc259d653298a7cac61423 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.407749) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.408215) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.408513) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.422947) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.423218) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-09-17 08:33:23-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 24.6M=0s 2016-09-17 08:33:23 (24.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.090483 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.527394) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.527722) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020006 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.577190) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:22.577551) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev f2fe5345c13ff5ec70dc259d653298a7cac61423 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev f2fe5345c13ff5ec70dc259d653298a7cac61423 --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=d6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-09-17 08:33:23,450 truncating revision to first 12 chars 2016-09-17 08:33:23,450 Setting DEBUG logging. 2016-09-17 08:33:23,450 attempt 1/10 2016-09-17 08:33:23,450 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/f2fe5345c13f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-17 08:33:23,743 unpacking tar archive at: fx-team-f2fe5345c13f/testing/mozharness/ program finished with exit code 0 elapsedTime=0.620468 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:23.211663) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:23.212078) ========= script_repo_revision: f2fe5345c13ff5ec70dc259d653298a7cac61423 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:23.212520) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:23.212822) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-17 08:33:23.222481) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 47 secs) (at 2016-09-17 08:33:23.222934) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:33:24 INFO - MultiFileLogger online at 20160917 08:33:24 in /builds/slave/test 08:33:24 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 08:33:24 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:33:24 INFO - {'append_to_log': False, 08:33:24 INFO - 'base_work_dir': '/builds/slave/test', 08:33:24 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 08:33:24 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:33:24 INFO - 'branch': 'Fx-Team-Non-PGO', 08:33:24 INFO - 'buildbot_json_path': 'buildprops.json', 08:33:24 INFO - 'config_files': ('talos/linux_config.py',), 08:33:24 INFO - 'default_actions': ('clobber', 08:33:24 INFO - 'read-buildbot-config', 08:33:24 INFO - 'download-and-extract', 08:33:24 INFO - 'populate-webroot', 08:33:24 INFO - 'create-virtualenv', 08:33:24 INFO - 'install', 08:33:24 INFO - 'run-tests'), 08:33:24 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:33:24 INFO - 'download_minidump_stackwalk': True, 08:33:24 INFO - 'download_symbols': 'ondemand', 08:33:24 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:33:24 INFO - 'tooltool.py': '/tools/tooltool.py', 08:33:24 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:33:24 INFO - '/tools/misc-python/virtualenv.py')}, 08:33:24 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:33:24 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:33:24 INFO - 'installer_path': 'installer.exe', 08:33:24 INFO - 'log_level': 'info', 08:33:24 INFO - 'log_name': 'talos', 08:33:24 INFO - 'log_to_console': True, 08:33:24 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:33:24 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:33:24 INFO - 'opt_config_files': (), 08:33:24 INFO - 'pip_index': False, 08:33:24 INFO - 'sps_profile': False, 08:33:24 INFO - 'sps_profile_interval': 0, 08:33:24 INFO - 'suite': 'dromaeojs', 08:33:24 INFO - 'system_bits': '32', 08:33:24 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:33:24 INFO - 'title': 'talos-linux64-ix-034', 08:33:24 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:33:24 INFO - 'use_talos_json': True, 08:33:24 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:33:24 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:33:24 INFO - 'work_dir': 'build'} 08:33:24 INFO - [mozharness: 2016-09-17 15:33:24.190422Z] Running clobber step. 08:33:24 INFO - Running pre-action listener: _resource_record_pre_action 08:33:24 INFO - Running main action method: clobber 08:33:24 INFO - rmtree: /builds/slave/test/build 08:33:24 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:33:24 INFO - Running post-action listener: _resource_record_post_action 08:33:24 INFO - [mozharness: 2016-09-17 15:33:24.654587Z] Finished clobber step (success) 08:33:24 INFO - [mozharness: 2016-09-17 15:33:24.654690Z] Running read-buildbot-config step. 08:33:24 INFO - Running pre-action listener: _resource_record_pre_action 08:33:24 INFO - Running main action method: read_buildbot_config 08:33:24 INFO - Using buildbot properties: 08:33:24 INFO - { 08:33:24 INFO - "project": "", 08:33:24 INFO - "product": "firefox", 08:33:24 INFO - "script_repo_revision": "production", 08:33:24 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 08:33:24 INFO - "repository": "", 08:33:24 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 08:33:24 INFO - "buildid": "20160916143618", 08:33:24 INFO - "pgo_build": "False", 08:33:24 INFO - "basedir": "/builds/slave/test", 08:33:24 INFO - "buildnumber": 3322, 08:33:24 INFO - "slavename": "talos-linux64-ix-034", 08:33:24 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 08:33:24 INFO - "platform": "ubuntu64_hw", 08:33:24 INFO - "scheduler": "tests-fx-team-linux64-talos", 08:33:24 INFO - "branch": "fx-team", 08:33:24 INFO - "repo_path": "integration/fx-team", 08:33:24 INFO - "revision": "f2fe5345c13ff5ec70dc259d653298a7cac61423", 08:33:24 INFO - "stage_platform": "linux64", 08:33:24 INFO - "builduid": "6096345e4c47423bba4fe6e518696367", 08:33:24 INFO - "slavebuilddir": "test" 08:33:24 INFO - } 08:33:24 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 08:33:24 INFO - Running post-action listener: _resource_record_post_action 08:33:24 INFO - [mozharness: 2016-09-17 15:33:24.657175Z] Finished read-buildbot-config step (success) 08:33:24 INFO - [mozharness: 2016-09-17 15:33:24.657286Z] Running download-and-extract step. 08:33:24 INFO - Running pre-action listener: _resource_record_pre_action 08:33:24 INFO - Running main action method: download_and_extract 08:33:24 INFO - mkdir: /builds/slave/test/build/tests 08:33:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:33:24 INFO - trying https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 08:33:24 INFO - Downloading https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 08:33:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 08:33:25 INFO - Downloaded 1361 bytes. 08:33:25 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 08:33:25 INFO - Using the following test package requirements: 08:33:25 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 08:33:25 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:33:25 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:33:25 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:33:25 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 08:33:25 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:33:25 INFO - u'jsshell-linux-x86_64.zip'], 08:33:25 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:33:25 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:33:25 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 08:33:25 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:33:25 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:33:25 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:33:25 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:33:25 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:33:25 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:33:25 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:33:25 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:33:25 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:33:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 08:33:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:33:25 INFO - Fetch https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip into memory 08:33:25 INFO - Expected file size: 20365791 08:33:29 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 08:33:29 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 08:33:29 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:33:29 INFO - Fetch https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip into memory 08:33:30 INFO - Expected file size: 20365791 08:33:35 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 08:33:35 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 08:33:35 INFO - Fetch https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip into memory 08:33:35 INFO - Expected file size: 14414048 08:33:36 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')]} 08:33:36 INFO - trying https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 08:33:36 INFO - Downloading https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 08:33:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 08:33:38 INFO - Downloaded 55593420 bytes. 08:33:38 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 08:33:38 INFO - mkdir: /builds/slave/test/properties 08:33:38 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:33:38 INFO - Writing to file /builds/slave/test/properties/build_url 08:33:38 INFO - Contents: 08:33:38 INFO - build_url:https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 08:33:38 INFO - Running post-action listener: _resource_record_post_action 08:33:38 INFO - Running post-action listener: set_extra_try_arguments 08:33:38 INFO - [mozharness: 2016-09-17 15:33:38.921798Z] Finished download-and-extract step (success) 08:33:38 INFO - [mozharness: 2016-09-17 15:33:38.922026Z] Running populate-webroot step. 08:33:38 INFO - Running pre-action listener: _resource_record_pre_action 08:33:38 INFO - Running main action method: populate_webroot 08:33:38 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:33:38 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:33:38 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:33:38 INFO - '--tppagecycles', 08:33:38 INFO - '7'], 08:33:38 INFO - 'tests': ['tsvgm']}}, 08:33:38 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:33:38 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:33:38 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:33:38 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:33:38 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:33:38 INFO - 'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:33:38 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:33:38 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:33:38 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:33:38 INFO - 'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['damp', 'tps']}, 08:33:38 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:33:38 INFO - 'tests': ['damp', 'tps']}, 08:33:38 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['dromaeo_dom']}, 08:33:38 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:33:38 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['basic_compositor_video']}, 08:33:38 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:33:38 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['a11yr', 08:33:38 INFO - 'ts_paint', 08:33:38 INFO - 'tpaint', 08:33:38 INFO - 'sessionrestore', 08:33:38 INFO - 'sessionrestore_no_auto_restore', 08:33:38 INFO - 'tabpaint']}, 08:33:38 INFO - 'other-e10s': {'tests': ['a11yr', 08:33:38 INFO - 'ts_paint', 08:33:38 INFO - 'tpaint', 08:33:38 INFO - 'sessionrestore', 08:33:38 INFO - 'sessionrestore_no_auto_restore', 08:33:38 INFO - 'tabpaint']}, 08:33:38 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:33:38 INFO - 'ts_paint', 08:33:38 INFO - 'tpaint', 08:33:38 INFO - 'sessionrestore', 08:33:38 INFO - 'sessionrestore_no_auto_restore', 08:33:38 INFO - 'tabpaint']}, 08:33:38 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:33:38 INFO - 'ts_paint', 08:33:38 INFO - 'tpaint', 08:33:38 INFO - 'sessionrestore', 08:33:38 INFO - 'sessionrestore_no_auto_restore', 08:33:38 INFO - 'tabpaint']}, 08:33:38 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['a11yr', 08:33:38 INFO - 'ts_paint', 08:33:38 INFO - 'tpaint', 08:33:38 INFO - 'sessionrestore', 08:33:38 INFO - 'sessionrestore_no_auto_restore', 08:33:38 INFO - 'tabpaint']}, 08:33:38 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['a11yr', 08:33:38 INFO - 'ts_paint', 08:33:38 INFO - 'tpaint', 08:33:38 INFO - 'sessionrestore', 08:33:38 INFO - 'sessionrestore_no_auto_restore', 08:33:38 INFO - 'tabpaint']}, 08:33:38 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['tsvgx', 08:33:38 INFO - 'tsvgr_opacity', 08:33:38 INFO - 'tart', 08:33:38 INFO - 'tscrollx', 08:33:38 INFO - 'cart']}, 08:33:38 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:33:38 INFO - 'tsvgr_opacity', 08:33:38 INFO - 'tart', 08:33:38 INFO - 'tscrollx', 08:33:38 INFO - 'cart']}, 08:33:38 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:33:38 INFO - 'talos_options': ['--disable-e10s'], 08:33:38 INFO - 'tests': ['tp5o']}, 08:33:38 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:33:38 INFO - 'tests': ['tp5o']}, 08:33:38 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:33:38 INFO - 'talos_options': ['--disable-e10s', 08:33:38 INFO - '--xperf_path', 08:33:38 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:33:38 INFO - 'tests': ['tp5n']}, 08:33:38 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:33:38 INFO - 'talos_options': ['--xperf_path', 08:33:38 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:33:38 INFO - 'tests': ['tp5n']}}, 08:33:38 INFO - 'talos.zip': {'path': '', 08:33:38 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:33:38 INFO - Running post-action listener: _resource_record_post_action 08:33:38 INFO - [mozharness: 2016-09-17 15:33:38.937532Z] Finished populate-webroot step (success) 08:33:38 INFO - [mozharness: 2016-09-17 15:33:38.937621Z] Running create-virtualenv step. 08:33:38 INFO - Running pre-action listener: _resource_record_pre_action 08:33:38 INFO - Running main action method: create_virtualenv 08:33:38 INFO - Creating virtualenv /builds/slave/test/build/venv 08:33:38 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 08:33:38 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:33:39 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:33:39 INFO - Using real prefix '/usr' 08:33:39 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:33:39 INFO - Installing distribute.............................................................................................................................................................................................done. 08:33:41 INFO - Installing pip.................done. 08:33:41 INFO - Return code: 0 08:33:41 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:33:41 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')]} 08:33:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:33:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:41 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')]} 08:33:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:33:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:41 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:33:41 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 08:33:41 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 08:33:41 INFO - Using env: {'DISPLAY': ':0', 08:33:41 INFO - 'HOME': '/home/cltbld', 08:33:41 INFO - 'LANG': 'en_US.UTF-8', 08:33:41 INFO - 'LANGUAGE': 'en_US:en', 08:33:41 INFO - 'LOGNAME': 'cltbld', 08:33:41 INFO - 'MAIL': '/var/mail/cltbld', 08:33:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:33:41 INFO - 'MOZ_NO_REMOTE': '1', 08:33:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:33:41 INFO - 'NO_EM_RESTART': '1', 08:33:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:33:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:33:41 INFO - 'PWD': '/builds/slave/test', 08:33:41 INFO - 'SHELL': '/bin/bash', 08:33:41 INFO - 'SHLVL': '1', 08:33:41 INFO - 'TERM': 'linux', 08:33:41 INFO - 'TMOUT': '86400', 08:33:41 INFO - 'USER': 'cltbld', 08:33:41 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:33:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:33:41 INFO - '_': '/tools/buildbot/bin/python'} 08:33:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:33:41 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 08:33:41 INFO - Cleaning up... 08:33:41 INFO - Return code: 0 08:33:41 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:33:41 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')]} 08:33:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:33:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:41 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')]} 08:33:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:33:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:41 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:33:41 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 08:33:41 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 08:33:41 INFO - Using env: {'DISPLAY': ':0', 08:33:41 INFO - 'HOME': '/home/cltbld', 08:33:41 INFO - 'LANG': 'en_US.UTF-8', 08:33:41 INFO - 'LANGUAGE': 'en_US:en', 08:33:41 INFO - 'LOGNAME': 'cltbld', 08:33:41 INFO - 'MAIL': '/var/mail/cltbld', 08:33:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:33:41 INFO - 'MOZ_NO_REMOTE': '1', 08:33:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:33:41 INFO - 'NO_EM_RESTART': '1', 08:33:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:33:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:33:41 INFO - 'PWD': '/builds/slave/test', 08:33:41 INFO - 'SHELL': '/bin/bash', 08:33:41 INFO - 'SHLVL': '1', 08:33:41 INFO - 'TERM': 'linux', 08:33:41 INFO - 'TMOUT': '86400', 08:33:41 INFO - 'USER': 'cltbld', 08:33:41 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:33:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:33:41 INFO - '_': '/tools/buildbot/bin/python'} 08:33:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:33:41 INFO - Downloading/unpacking psutil>=3.1.1 08:33:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:33:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:33:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:33:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:33:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:33:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:33:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:33:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:33:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:33:43 INFO - Installing collected packages: psutil 08:33:43 INFO - Running setup.py install for psutil 08:33:44 INFO - building 'psutil._psutil_linux' extension 08:33:44 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 08:33:44 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 08:33:44 INFO - building 'psutil._psutil_posix' extension 08:33:44 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 08:33:44 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 08:33:44 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:33:44 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:33:44 INFO - Successfully installed psutil 08:33:44 INFO - Cleaning up... 08:33:44 INFO - Return code: 0 08:33:44 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:33:44 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')]} 08:33:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:33:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:44 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')]} 08:33:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:33:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:44 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:33:44 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 08:33:44 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 08:33:44 INFO - Using env: {'DISPLAY': ':0', 08:33:44 INFO - 'HOME': '/home/cltbld', 08:33:44 INFO - 'LANG': 'en_US.UTF-8', 08:33:44 INFO - 'LANGUAGE': 'en_US:en', 08:33:44 INFO - 'LOGNAME': 'cltbld', 08:33:44 INFO - 'MAIL': '/var/mail/cltbld', 08:33:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:33:44 INFO - 'MOZ_NO_REMOTE': '1', 08:33:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:33:44 INFO - 'NO_EM_RESTART': '1', 08:33:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:33:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:33:44 INFO - 'PWD': '/builds/slave/test', 08:33:44 INFO - 'SHELL': '/bin/bash', 08:33:44 INFO - 'SHLVL': '1', 08:33:44 INFO - 'TERM': 'linux', 08:33:44 INFO - 'TMOUT': '86400', 08:33:44 INFO - 'USER': 'cltbld', 08:33:44 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:33:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:33:44 INFO - '_': '/tools/buildbot/bin/python'} 08:33:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:33:44 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:33:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:33:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:33:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:33:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:33:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:33:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:33:46 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:33:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:33:46 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:33:46 INFO - Installing collected packages: mozsystemmonitor 08:33:46 INFO - Running setup.py install for mozsystemmonitor 08:33:46 INFO - Successfully installed mozsystemmonitor 08:33:46 INFO - Cleaning up... 08:33:46 INFO - Return code: 0 08:33:46 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:33:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:33:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:33:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:33:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:33:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:46 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:33:46 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 08:33:46 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 08:33:46 INFO - Using env: {'DISPLAY': ':0', 08:33:46 INFO - 'HOME': '/home/cltbld', 08:33:46 INFO - 'LANG': 'en_US.UTF-8', 08:33:46 INFO - 'LANGUAGE': 'en_US:en', 08:33:46 INFO - 'LOGNAME': 'cltbld', 08:33:46 INFO - 'MAIL': '/var/mail/cltbld', 08:33:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:33:46 INFO - 'MOZ_NO_REMOTE': '1', 08:33:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:33:46 INFO - 'NO_EM_RESTART': '1', 08:33:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:33:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:33:46 INFO - 'PWD': '/builds/slave/test', 08:33:46 INFO - 'SHELL': '/bin/bash', 08:33:46 INFO - 'SHLVL': '1', 08:33:46 INFO - 'TERM': 'linux', 08:33:46 INFO - 'TMOUT': '86400', 08:33:46 INFO - 'USER': 'cltbld', 08:33:46 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:33:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:33:46 INFO - '_': '/tools/buildbot/bin/python'} 08:33:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:33:46 INFO - Downloading/unpacking jsonschema==2.5.1 08:33:46 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 08:33:46 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 08:33:46 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 08:33:46 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 08:33:46 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 08:33:46 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 08:33:48 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:33:48 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:33:48 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 08:33:48 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 08:33:48 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 08:33:48 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 08:33:48 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 08:33:48 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 08:33:49 INFO - Downloading functools32-3.2.3-2.tar.gz 08:33:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:33:49 INFO - warning: no files found matching '*.txt' 08:33:49 INFO - no previously-included directories found matching 'build' 08:33:49 INFO - no previously-included directories found matching 'dist' 08:33:49 INFO - no previously-included directories found matching '.git*' 08:33:49 INFO - Installing collected packages: jsonschema, functools32 08:33:49 INFO - Running setup.py install for functools32 08:33:49 INFO - warning: no files found matching '*.txt' 08:33:49 INFO - no previously-included directories found matching 'build' 08:33:49 INFO - no previously-included directories found matching 'dist' 08:33:49 INFO - no previously-included directories found matching '.git*' 08:33:49 INFO - Successfully installed jsonschema functools32 08:33:49 INFO - Cleaning up... 08:33:49 INFO - Return code: 0 08:33:49 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:33:49 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')]} 08:33:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:33:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:49 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')]} 08:33:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:33:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:49 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:33:49 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 08:33:49 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 08:33:49 INFO - Using env: {'DISPLAY': ':0', 08:33:49 INFO - 'HOME': '/home/cltbld', 08:33:49 INFO - 'LANG': 'en_US.UTF-8', 08:33:49 INFO - 'LANGUAGE': 'en_US:en', 08:33:49 INFO - 'LOGNAME': 'cltbld', 08:33:49 INFO - 'MAIL': '/var/mail/cltbld', 08:33:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:33:49 INFO - 'MOZ_NO_REMOTE': '1', 08:33:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:33:49 INFO - 'NO_EM_RESTART': '1', 08:33:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:33:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:33:49 INFO - 'PWD': '/builds/slave/test', 08:33:49 INFO - 'SHELL': '/bin/bash', 08:33:49 INFO - 'SHLVL': '1', 08:33:49 INFO - 'TERM': 'linux', 08:33:49 INFO - 'TMOUT': '86400', 08:33:49 INFO - 'USER': 'cltbld', 08:33:49 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:33:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:33:49 INFO - '_': '/tools/buildbot/bin/python'} 08:33:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:33:49 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:33:49 INFO - Cleaning up... 08:33:49 INFO - Return code: 0 08:33:49 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:33:49 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')]} 08:33:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:33:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:49 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')]} 08:33:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:33:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:49 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:33:49 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 08:33:49 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 08:33:49 INFO - Using env: {'DISPLAY': ':0', 08:33:49 INFO - 'HOME': '/home/cltbld', 08:33:49 INFO - 'LANG': 'en_US.UTF-8', 08:33:49 INFO - 'LANGUAGE': 'en_US:en', 08:33:49 INFO - 'LOGNAME': 'cltbld', 08:33:49 INFO - 'MAIL': '/var/mail/cltbld', 08:33:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:33:49 INFO - 'MOZ_NO_REMOTE': '1', 08:33:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:33:49 INFO - 'NO_EM_RESTART': '1', 08:33:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:33:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:33:49 INFO - 'PWD': '/builds/slave/test', 08:33:49 INFO - 'SHELL': '/bin/bash', 08:33:49 INFO - 'SHLVL': '1', 08:33:49 INFO - 'TERM': 'linux', 08:33:49 INFO - 'TMOUT': '86400', 08:33:49 INFO - 'USER': 'cltbld', 08:33:49 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:33:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:33:49 INFO - '_': '/tools/buildbot/bin/python'} 08:33:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:33:49 INFO - Downloading/unpacking blobuploader==1.2.4 08:33:49 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 08:33:49 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 08:33:49 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 08:33:49 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 08:33:49 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 08:33:49 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 08:33:51 INFO - Downloading blobuploader-1.2.4.tar.gz 08:33:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:33:51 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:33:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:33:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:33:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:33:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:33:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:33:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:33:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:33:52 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:33:52 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 08:33:52 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 08:33:52 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 08:33:52 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 08:33:52 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 08:33:52 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 08:33:52 INFO - Downloading docopt-0.6.1.tar.gz 08:33:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:33:52 INFO - Installing collected packages: blobuploader, requests, docopt 08:33:52 INFO - Running setup.py install for blobuploader 08:33:52 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:33:52 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:33:52 INFO - Running setup.py install for requests 08:33:52 INFO - Running setup.py install for docopt 08:33:53 INFO - Successfully installed blobuploader requests docopt 08:33:53 INFO - Cleaning up... 08:33:53 INFO - Return code: 0 08:33:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:33:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:33:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:33:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:33:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:33:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:53 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:33:53 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 08:33:53 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 08:33:53 INFO - Using env: {'DISPLAY': ':0', 08:33:53 INFO - 'HOME': '/home/cltbld', 08:33:53 INFO - 'LANG': 'en_US.UTF-8', 08:33:53 INFO - 'LANGUAGE': 'en_US:en', 08:33:53 INFO - 'LOGNAME': 'cltbld', 08:33:53 INFO - 'MAIL': '/var/mail/cltbld', 08:33:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:33:53 INFO - 'MOZ_NO_REMOTE': '1', 08:33:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:33:53 INFO - 'NO_EM_RESTART': '1', 08:33:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:33:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:33:53 INFO - 'PWD': '/builds/slave/test', 08:33:53 INFO - 'SHELL': '/bin/bash', 08:33:53 INFO - 'SHLVL': '1', 08:33:53 INFO - 'TERM': 'linux', 08:33:53 INFO - 'TMOUT': '86400', 08:33:53 INFO - 'USER': 'cltbld', 08:33:53 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:33:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:33:53 INFO - '_': '/tools/buildbot/bin/python'} 08:33:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:33:53 INFO - Running setup.py (path:/tmp/pip-4KJxNS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:33:53 INFO - Running setup.py (path:/tmp/pip-ERmvA1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:33:53 INFO - Running setup.py (path:/tmp/pip-ZEV7UO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:33:53 INFO - Running setup.py (path:/tmp/pip-lwO_gv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:33:53 INFO - Running setup.py (path:/tmp/pip-Z0eDq4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:33:53 INFO - Running setup.py (path:/tmp/pip-bZMVrC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:33:53 INFO - Running setup.py (path:/tmp/pip-hDfZuQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:33:53 INFO - Running setup.py (path:/tmp/pip-PljLZE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:33:53 INFO - Running setup.py (path:/tmp/pip-bVBe39-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:33:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:33:53 INFO - Running setup.py (path:/tmp/pip-KvgsA5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:33:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:33:54 INFO - Running setup.py (path:/tmp/pip-BE22JY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:33:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:33:54 INFO - Running setup.py (path:/tmp/pip-W6WPdn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:33:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:33:54 INFO - Running setup.py (path:/tmp/pip-HmhUnu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:33:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:33:54 INFO - Running setup.py (path:/tmp/pip-ZwSj_S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:33:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:33:54 INFO - Running setup.py (path:/tmp/pip-TRp5e8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:33:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:33:54 INFO - Running setup.py (path:/tmp/pip-E_B4kn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:33:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:33:54 INFO - Running setup.py (path:/tmp/pip-NHbNyx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:33:54 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:33:54 INFO - Running setup.py install for manifestparser 08:33:54 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:33:54 INFO - Running setup.py install for mozcrash 08:33:54 INFO - Running setup.py install for mozdebug 08:33:54 INFO - Running setup.py install for mozdevice 08:33:54 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:33:54 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:33:54 INFO - Running setup.py install for mozfile 08:33:55 INFO - Running setup.py install for mozhttpd 08:33:55 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Running setup.py install for mozinfo 08:33:55 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Running setup.py install for mozInstall 08:33:55 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Running setup.py install for mozleak 08:33:55 INFO - Running setup.py install for mozlog 08:33:55 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Running setup.py install for moznetwork 08:33:55 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Running setup.py install for mozprocess 08:33:55 INFO - Running setup.py install for mozprofile 08:33:55 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:33:55 INFO - Running setup.py install for mozrunner 08:33:56 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:33:56 INFO - Running setup.py install for mozscreenshot 08:33:56 INFO - Running setup.py install for moztest 08:33:56 INFO - Running setup.py install for mozversion 08:33:56 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:33:56 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:33:56 INFO - Cleaning up... 08:33:56 INFO - Return code: 0 08:33:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:33:56 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')]} 08:33:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:33:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:56 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')]} 08:33:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:33:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:33:56 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:33:56 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 08:33:56 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 08:33:56 INFO - Using env: {'DISPLAY': ':0', 08:33:56 INFO - 'HOME': '/home/cltbld', 08:33:56 INFO - 'LANG': 'en_US.UTF-8', 08:33:56 INFO - 'LANGUAGE': 'en_US:en', 08:33:56 INFO - 'LOGNAME': 'cltbld', 08:33:56 INFO - 'MAIL': '/var/mail/cltbld', 08:33:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:33:56 INFO - 'MOZ_NO_REMOTE': '1', 08:33:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:33:56 INFO - 'NO_EM_RESTART': '1', 08:33:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:33:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:33:56 INFO - 'PWD': '/builds/slave/test', 08:33:56 INFO - 'SHELL': '/bin/bash', 08:33:56 INFO - 'SHLVL': '1', 08:33:56 INFO - 'TERM': 'linux', 08:33:56 INFO - 'TMOUT': '86400', 08:33:56 INFO - 'USER': 'cltbld', 08:33:56 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:33:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:33:56 INFO - '_': '/tools/buildbot/bin/python'} 08:33:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:33:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:33:56 INFO - Running setup.py (path:/tmp/pip-_VKenK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:33:56 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)) 08:33:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:33:56 INFO - Running setup.py (path:/tmp/pip-RuPjBu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:33:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:33:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:33:56 INFO - Running setup.py (path:/tmp/pip-thd377-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:33:56 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)) 08:33:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:33:56 INFO - Running setup.py (path:/tmp/pip-Fucnwb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:33:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:33:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:33:56 INFO - Running setup.py (path:/tmp/pip-UXc0gT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:33:57 INFO - Running setup.py (path:/tmp/pip-AEICEN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:33:57 INFO - Running setup.py (path:/tmp/pip-fnXhGY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:33:57 INFO - Running setup.py (path:/tmp/pip-450DnU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:33:57 INFO - Running setup.py (path:/tmp/pip-JfV7TF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:33:57 INFO - Running setup.py (path:/tmp/pip-dQe6Vc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:33:57 INFO - Running setup.py (path:/tmp/pip-JDaXtj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:33:57 INFO - Running setup.py (path:/tmp/pip-N8xVIX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:33:57 INFO - Running setup.py (path:/tmp/pip-Gkb_Ls-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:33:57 INFO - Running setup.py (path:/tmp/pip-ly85eY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:33:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:33:57 INFO - Running setup.py (path:/tmp/pip-x4zK9C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:33:57 INFO - Running setup.py (path:/tmp/pip-BFlnhH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:33:57 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)) 08:33:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:33:57 INFO - Running setup.py (path:/tmp/pip-3b_kwr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:33:57 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)) 08:33:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:33:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:33:57 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)) 08:33:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:33:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:33:57 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:33:57 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 08:33:57 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 08:33:57 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 08:33:57 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 08:33:57 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 08:33:57 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 08:33:59 INFO - Downloading blessings-1.6.tar.gz 08:33:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:33:59 INFO - Installing collected packages: blessings 08:33:59 INFO - Running setup.py install for blessings 08:33:59 INFO - Successfully installed blessings 08:33:59 INFO - Cleaning up... 08:34:00 INFO - Return code: 0 08:34:00 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:34:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:34:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:34:00 INFO - Reading from file tmpfile_stdout 08:34:00 INFO - Current package versions: 08:34:00 INFO - argparse == 1.2.1 08:34:00 INFO - blessings == 1.6 08:34:00 INFO - blobuploader == 1.2.4 08:34:00 INFO - docopt == 0.6.1 08:34:00 INFO - functools32 == 3.2.3-2 08:34:00 INFO - jsonschema == 2.5.1 08:34:00 INFO - manifestparser == 1.1 08:34:00 INFO - mozInstall == 1.12 08:34:00 INFO - mozcrash == 0.17 08:34:00 INFO - mozdebug == 0.1 08:34:00 INFO - mozdevice == 0.48 08:34:00 INFO - mozfile == 1.2 08:34:00 INFO - mozhttpd == 0.7 08:34:00 INFO - mozinfo == 0.9 08:34:00 INFO - mozleak == 0.1 08:34:00 INFO - mozlog == 3.4 08:34:00 INFO - moznetwork == 0.27 08:34:00 INFO - mozprocess == 0.23 08:34:00 INFO - mozprofile == 0.28 08:34:00 INFO - mozrunner == 6.12 08:34:00 INFO - mozscreenshot == 0.1 08:34:00 INFO - mozsystemmonitor == 0.3 08:34:00 INFO - moztest == 0.7 08:34:00 INFO - mozversion == 1.4 08:34:00 INFO - psutil == 3.1.1 08:34:00 INFO - requests == 1.2.3 08:34:00 INFO - wsgiref == 0.1.2 08:34:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:34:00 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')]} 08:34:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:34:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:34:00 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')]} 08:34:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:34:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:34:00 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:34:00 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 08:34:00 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 08:34:00 INFO - Using env: {'DISPLAY': ':0', 08:34:00 INFO - 'HOME': '/home/cltbld', 08:34:00 INFO - 'LANG': 'en_US.UTF-8', 08:34:00 INFO - 'LANGUAGE': 'en_US:en', 08:34:00 INFO - 'LOGNAME': 'cltbld', 08:34:00 INFO - 'MAIL': '/var/mail/cltbld', 08:34:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:34:00 INFO - 'MOZ_NO_REMOTE': '1', 08:34:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:34:00 INFO - 'NO_EM_RESTART': '1', 08:34:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:34:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:34:00 INFO - 'PWD': '/builds/slave/test', 08:34:00 INFO - 'SHELL': '/bin/bash', 08:34:00 INFO - 'SHLVL': '1', 08:34:00 INFO - 'TERM': 'linux', 08:34:00 INFO - 'TMOUT': '86400', 08:34:00 INFO - 'USER': 'cltbld', 08:34:00 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:34:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:34:00 INFO - '_': '/tools/buildbot/bin/python'} 08:34:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 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)) 08:34:00 INFO - Cleaning up... 08:34:00 INFO - Return code: 0 08:34:00 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:34:00 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')]} 08:34:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:34:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:34:00 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')]} 08:34:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:34:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:34:00 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 0x7feb02b1df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a078a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2ad4ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', '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 08:34:00 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 08:34:00 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 08:34:00 INFO - Using env: {'DISPLAY': ':0', 08:34:00 INFO - 'HOME': '/home/cltbld', 08:34:00 INFO - 'LANG': 'en_US.UTF-8', 08:34:00 INFO - 'LANGUAGE': 'en_US:en', 08:34:00 INFO - 'LOGNAME': 'cltbld', 08:34:00 INFO - 'MAIL': '/var/mail/cltbld', 08:34:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:34:00 INFO - 'MOZ_NO_REMOTE': '1', 08:34:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:34:00 INFO - 'NO_EM_RESTART': '1', 08:34:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:34:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:34:00 INFO - 'PWD': '/builds/slave/test', 08:34:00 INFO - 'SHELL': '/bin/bash', 08:34:00 INFO - 'SHLVL': '1', 08:34:00 INFO - 'TERM': 'linux', 08:34:00 INFO - 'TMOUT': '86400', 08:34:00 INFO - 'USER': 'cltbld', 08:34:00 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:34:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:34:00 INFO - '_': '/tools/buildbot/bin/python'} 08:34:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:34:00 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:34:00 INFO - Cleaning up... 08:34:00 INFO - Return code: 0 08:34:00 INFO - Running post-action listener: _resource_record_post_action 08:34:00 INFO - Running post-action listener: _start_resource_monitoring 08:34:00 INFO - Starting resource monitoring. 08:34:00 INFO - [mozharness: 2016-09-17 15:34:00.696039Z] Finished create-virtualenv step (success) 08:34:00 INFO - [mozharness: 2016-09-17 15:34:00.696543Z] Running install step. 08:34:00 INFO - Running pre-action listener: _resource_record_pre_action 08:34:00 INFO - Running main action method: install 08:34:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:34:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:34:00 INFO - Reading from file tmpfile_stdout 08:34:00 INFO - Detecting whether we're running mozinstall >=1.0... 08:34:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:34:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:34:00 INFO - Reading from file tmpfile_stdout 08:34:00 INFO - Output received: 08:34:00 INFO - Usage: mozinstall [options] installer 08:34:00 INFO - Options: 08:34:00 INFO - -h, --help show this help message and exit 08:34:00 INFO - -d DEST, --destination=DEST 08:34:00 INFO - Directory to install application into. [default: 08:34:00 INFO - "/builds/slave/test"] 08:34:00 INFO - --app=APP Application being installed. [default: firefox] 08:34:00 INFO - mkdir: /builds/slave/test/build/application 08:34:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:34:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 08:34:17 INFO - Reading from file tmpfile_stdout 08:34:17 INFO - Output received: 08:34:17 INFO - /builds/slave/test/build/application/firefox/firefox 08:34:17 INFO - Running post-action listener: _resource_record_post_action 08:34:17 INFO - [mozharness: 2016-09-17 15:34:17.066806Z] Finished install step (success) 08:34:17 INFO - [mozharness: 2016-09-17 15:34:17.067050Z] Running run-tests step. 08:34:17 INFO - Running pre-action listener: _resource_record_pre_action 08:34:17 INFO - Running main action method: run_tests 08:34:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:34:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:34:17 INFO - Python 2.7.3 08:34:17 INFO - Return code: 0 08:34:17 INFO - grabbing minidump binary from tooltool 08:34:17 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')]} 08:34:17 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 0x2ad1f60>, '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 0x2ad2d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ad31d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:34:17 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 08:34:17 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 08:34:17 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 08:34:17 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:34:17 INFO - Return code: 0 08:34:17 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:34:17 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:34:17 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:34:17 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:34:17 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:34:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-034', '--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 08:34:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-034 --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 08:34:17 INFO - Using env: {'DISPLAY': ':0', 08:34:17 INFO - 'HOME': '/home/cltbld', 08:34:17 INFO - 'LANG': 'en_US.UTF-8', 08:34:17 INFO - 'LANGUAGE': 'en_US:en', 08:34:17 INFO - 'LOGNAME': 'cltbld', 08:34:17 INFO - 'MAIL': '/var/mail/cltbld', 08:34:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:34:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:34:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:34:17 INFO - 'MOZ_NO_REMOTE': '1', 08:34:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:34:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:34:17 INFO - 'NO_EM_RESTART': '1', 08:34:17 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:34:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:34:17 INFO - 'PWD': '/builds/slave/test', 08:34:17 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:34:17 INFO - 'SHELL': '/bin/bash', 08:34:17 INFO - 'SHLVL': '1', 08:34:17 INFO - 'TERM': 'linux', 08:34:17 INFO - 'TMOUT': '86400', 08:34:17 INFO - 'USER': 'cltbld', 08:34:17 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216', 08:34:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:34:17 INFO - '_': '/tools/buildbot/bin/python'} 08:34:17 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-034', '--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 08:34:17 INFO - mozversion application_buildid: 20160916143618 08:34:17 INFO - mozversion application_changeset: f2fe5345c13ff5ec70dc259d653298a7cac61423 08:34:17 INFO - mozversion application_display_name: Nightly 08:34:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:34:17 INFO - mozversion application_name: Firefox 08:34:17 INFO - mozversion application_remotingname: firefox 08:34:17 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 08:34:17 INFO - mozversion application_vendor: Mozilla 08:34:17 INFO - mozversion application_version: 51.0a1 08:34:17 INFO - mozversion platform_buildid: 20160916143618 08:34:17 INFO - mozversion platform_changeset: f2fe5345c13ff5ec70dc259d653298a7cac61423 08:34:17 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 08:34:17 INFO - mozversion platform_version: 51.0a1 08:34:17 INFO - using testdate: 1474126457 08:34:17 INFO - actual date: 1474126457 08:34:17 INFO - starting webserver on 'localhost:47837' 08:34:17 INFO - SUITE-START | Running 2 tests 08:34:17 INFO - TEST-START | dromaeo_css 08:34:17 INFO - operating with platform_type : linux_ 08:34:17 INFO - Initialising browser for dromaeo_css test... 08:34:17 INFO - TEST-INFO | started process 30350 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUV5fA_/profile http://localhost:47837/getInfo.html) 08:34:21 INFO - PROCESS | 30350 | __metrics Screen width/height:1600/1200 08:34:21 INFO - PROCESS | 30350 | colorDepth:24 08:34:21 INFO - PROCESS | 30350 | Browser inner width/height: 1024/697 08:34:21 INFO - PROCESS | 30350 | __metrics 08:34:22 INFO - PROCESS | 30350 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:34:22 INFO - PROCESS | 30350 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:34:22 INFO - PROCESS | 30350 | console.error: PushService: 08:34:22 INFO - PROCESS | 30350 | stateChangeProcessEnqueue: Error transitioning state 08:34:22 INFO - PROCESS | 30350 | UnknownError 08:34:23 INFO - TEST-INFO | 30350: exit 0 08:34:23 INFO - Browser initialized. 08:34:23 INFO - Running cycle 1/1 for dromaeo_css test... 08:34:23 INFO - TEST-INFO | started process 30429 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUV5fA_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:34:35 INFO - PROCESS | 30429 | RSS: Main: 174678016 08:34:35 INFO - PROCESS | 30429 | 08:34:59 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.03337 seconds. 08:35:04 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:35:06 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:35:08 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:35:26 INFO - PROCESS | 30429 | 1474126526923 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] 08:35:31 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.13337 seconds. 08:35:34 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:35:39 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.06671 seconds. 08:35:50 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01672 seconds. 08:35:54 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.03334 seconds. 08:35:56 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.18338 seconds. 08:36:00 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05006 seconds. 08:36:07 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.006 seconds. 08:36:09 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.0167 seconds. 08:36:11 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:36:20 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.08338 seconds. 08:36:27 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:36:35 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01669 seconds. 08:36:37 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05005 seconds. 08:36:41 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01669 seconds. 08:36:44 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:36:46 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:36:48 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05009 seconds. 08:37:02 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:37:03 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00001 seconds. 08:37:04 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 2.01675 seconds. 08:37:10 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:37:16 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.03338 seconds. 08:37:22 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01668 seconds. 08:37:27 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.86678 seconds. 08:37:29 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.10005 seconds. 08:37:33 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05002 seconds. 08:37:36 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00009 seconds. 08:37:38 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01672 seconds. 08:37:40 INFO - PROCESS | 30429 | Cycle 1(1): loaded http://localhost:47837/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47837/tests/dromaeo/cssquery-ext.html) 08:37:41 INFO - PROCESS | 30429 | RSS: Main: 270348288 08:37:41 INFO - PROCESS | 30429 | 08:37:44 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01664 seconds. 08:37:45 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01669 seconds. 08:37:47 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.03339 seconds. 08:37:49 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:37:55 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:38:08 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:38:14 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:38:18 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:38:36 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05004 seconds. 08:38:41 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01672 seconds. 08:38:46 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00001 seconds. 08:38:48 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:38:58 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00005 seconds. 08:39:06 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:39:08 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:39:25 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00005 seconds. 08:39:26 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:39:28 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01667 seconds. 08:39:39 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:39:43 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:39:45 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00005 seconds. 08:39:53 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:39:55 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:39:56 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 2.00005 seconds. 08:39:59 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01676 seconds. 08:40:01 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01672 seconds. 08:40:11 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:40:13 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01672 seconds. 08:40:15 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:40:43 INFO - PROCESS | 30429 | Cycle 1(1): loaded http://localhost:47837/tests/dromaeo/cssquery-ext.html (next: http://localhost:47837/tests/dromaeo/cssquery-jquery.html) 08:40:44 INFO - PROCESS | 30429 | RSS: Main: 268787712 08:40:44 INFO - PROCESS | 30429 | 08:40:49 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05005 seconds. 08:40:55 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:41:13 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:41:17 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:41:25 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1 seconds. 08:41:27 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00001 seconds. 08:41:41 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:41:43 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:41:55 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00006 seconds. 08:42:07 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:42:12 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:42:13 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:42:14 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 2.00008 seconds. 08:42:21 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:42:28 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00001 seconds. 08:42:29 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:42:31 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01676 seconds. 08:42:34 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01274 seconds. 08:42:36 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00001 seconds. 08:42:40 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00005 seconds. 08:42:46 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:42:58 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:43:00 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:43:02 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:43:09 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:43:22 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00007 seconds. 08:43:24 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:43:27 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.0167 seconds. 08:43:30 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00006 seconds. 08:43:40 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:43:42 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:43:44 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:43:46 INFO - PROCESS | 30429 | Cycle 1(1): loaded http://localhost:47837/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47837/tests/dromaeo/cssquery-mootools.html) 08:43:47 INFO - PROCESS | 30429 | RSS: Main: 219734016 08:43:47 INFO - PROCESS | 30429 | 08:44:04 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00005 seconds. 08:44:05 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:44:20 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:44:22 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:44:27 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:44:36 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:44:40 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:44:42 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01673 seconds. 08:44:44 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01677 seconds. 08:44:48 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01673 seconds. 08:44:58 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:45:08 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00001 seconds. 08:45:15 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:45:44 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:45:46 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:45:57 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00006 seconds. 08:46:07 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00006 seconds. 08:46:11 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:46:27 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00008 seconds. 08:46:32 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:46:45 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:46:49 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:46:49 INFO - PROCESS | 30429 | Cycle 1(1): loaded http://localhost:47837/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47837/tests/dromaeo/cssquery-prototype.html) 08:46:50 INFO - PROCESS | 30429 | RSS: Main: 217669632 08:46:50 INFO - PROCESS | 30429 | 08:47:19 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:47:27 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05007 seconds. 08:47:29 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01672 seconds. 08:47:45 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:47:47 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:47:49 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:47:58 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:48:01 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:48:03 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:48:18 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.06668 seconds. 08:48:20 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:48:34 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:48:36 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:48:37 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 2.00011 seconds. 08:48:41 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01679 seconds. 08:48:44 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01669 seconds. 08:48:46 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.03342 seconds. 08:48:58 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:49:00 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01113 seconds. 08:49:02 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1 seconds. 08:49:08 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00005 seconds. 08:49:10 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:49:13 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01672 seconds. 08:49:16 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:49:22 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:49:33 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00005 seconds. 08:49:37 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00002 seconds. 08:49:39 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:49:41 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:49:47 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:49:53 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01672 seconds. 08:49:53 INFO - PROCESS | 30429 | Cycle 1(1): loaded http://localhost:47837/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47837/tests/dromaeo/cssquery-yui.html) 08:49:53 INFO - PROCESS | 30429 | RSS: Main: 218189824 08:49:53 INFO - PROCESS | 30429 | 08:49:57 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.03338 seconds. 08:50:12 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.03338 seconds. 08:50:26 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:50:36 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00007 seconds. 08:50:38 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:51:05 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:51:07 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:51:20 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01671 seconds. 08:51:25 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00006 seconds. 08:51:49 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00003 seconds. 08:51:51 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:52:06 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01677 seconds. 08:52:08 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01673 seconds. 08:52:14 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:52:16 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:52:20 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:52:22 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:52:26 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:52:28 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.00004 seconds. 08:52:37 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05005 seconds. 08:52:43 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.03338 seconds. 08:52:52 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.05004 seconds. 08:52:56 INFO - PROCESS | 30429 | [GFX1-]: Refresh driver waiting for the compositor for 1.01673 seconds. 08:52:56 INFO - PROCESS | 30429 | Cycle 1(1): loaded http://localhost:47837/tests/dromaeo/cssquery-yui.html (next: http://localhost:47837/tests/dromaeo/cssquery-dojo.html) 08:52:57 INFO - PROCESS | 30429 | RSS: Main: 310738944 08:52:57 INFO - PROCESS | 30429 | 08:52:57 INFO - PROCESS | 30429 | __start_tp_report 08:52:57 INFO - PROCESS | 30429 | _x_x_mozilla_page_load 08:52:57 INFO - PROCESS | 30429 | _x_x_mozilla_page_load_details 08:52:57 INFO - PROCESS | 30429 | |i|pagename|runs| 08:52:57 INFO - PROCESS | 30429 | |0;dojo.html;2593.3775893785496;2604.17968339973;2640.2607269964415;2645.5370310195713;2660.4679064187158;4622.514635963226;4682.929756053658;4704.270838020108;4723.409573803275;4731.479537250908;4741.359916411284;4747.098051370237;4751.049790041988;4751.168545504532;4760.262159365296;4266.701330906838;4289.592488713567;4316.201502721999;4337.392765012901;4345.913081738363;4337.371081193225;4349.804258808345;4390.604845563898;4410;4423.845165419211;4340.52254252032;4408.14041261954;4418.469783625953;4418.668599855007;4480.6639502037315;4378.190034843564;4490.842820501267;4491.955080449186;4495.078508905666;4499.550044995507;4204.684648651333;4339.891502712426;4343.2182207202695;4379.5182529921685;4394.472663280395;4621.491635920046;4638.466576343696;4679.766011699401;4705.55297246761;4725.243960966229;4939.703617782944;4941.407031156248;4942.135126352874;4947.802087916479;4958.20668693011;5026.1204289249235;5044.344235249431;5046.798128074873;5050.696958182521;5052.216906379517;4617.3304870793545;4650.046740418206;4684.531546845288;4695.107929493385;4769.356136921471;5160.200168973815;5180.145276029489;5183.585313174937;5232.424433312332;5242.7116508591635;4951.282064100686;4972.136315419921;4972.776225069881;4973.626977976666;5031.572316353077;4883.877903052452;4940.258961155855;4996.4503904570465;5062.190049592047;5068.467810879804;4965;4995.400551933719;5034.320366750442;5065.696058236444;5066.214736715815;4986.576141027981;4989.351384320088;4992.925106123411;5004.624653150955;5062.139436295838;4053.594640535982;4090.427340172378;4196.475440569929;4212.53662097169;4253.8723838284905;3633;3646.927061458756;3690.33573956685;3696.704263658901;3750.512433383697;4347.478302603708;4349.630281426051;4351.717138385995;4359.825606975749;4407.228734971367;5026.371703537058;5027.120253955616;5034.496550344937;5046.470120637354;5077.543021128116;4217.4306468626955;4279.486461624562;4285.357196420562;4291.957080429218;4312.89217769552;4415.2935530315635;4418.050119224382;4420.778961051935;4445.977770111193;4467.061916997402;4692.929606055912;4693.647976401715;4705;4710.36410084641;4765.023170250021;4898.3142360068905;4925.975370123127;4947.925781113358;4969.552740253394;5009.699418034929;4800.591949684316;4809.350737650372;4817.590504807131;4833.468318485035;4852.150873597036;5003.77483013258;5004.899902002013;5006.499350064964;5011.273365362075;5057.620678449204;4919.0407870464915;4963.851084467472;4975.800967961386;5003.374578177728;5075.670081444694;4910.656254062182;4911.607071434348;4926.975365123151;4928.728919909439;4977.253411988231;4898.2407726800975;4907.190313598217;4908.263760435963;4914.090893184629;4971.875703107451;4642.442906851199;4711.387519622427;4836.661433699607;4855.562999330077;4907.460179380337;4946.332245146859;4974.651774375904;4980.925286120783;5048.596112310933;5064.34163558735;4871.975640121776;4873.9025219496125;4883;4935.161022626234;4945.62907781925 08:52:57 INFO - PROCESS | 30429 | |1;ext.html;561.4638020690242;563.9577031722621;564.5511818104607;583.6527266276565;587.1808826686772;27800.165995020157;28538;30519.237019074535;30531.389372212543;30543;29784.957526486578;39231;40346;40395.394069088914;43859.561404385946;7504.212057733927;7609.657565409542;7619.42854285928;7628.427867909902;7635.160132385461;7393.630318484081;7496.212897645751;7502.5873576953245;7506.62466876654;7511.098668159829;7513.023306970086;7530.246975302481;7548.169701332849;7552.3202911737935;7557.0931488221495;7475.626218689071;7511.924880751205;7533.811654708621;7553.811154721121;7578.621068946586;7576.0908690956885;7632.198619144965;7633.091727068233;7635.121960974503;7638.847223055508;37511.624883751356;37880.621193787985;37884.43173352374;37895;37924.81037594822;2788.880272027683;2796.4267325198284;2904.390078083584;2966.2158790358885;3005.6693763686194;27908.16275511738;28221.858890705622;28490;28895.133146005654;29122.27194320159;3178.475551533994;3183.4110689522513;3231.062991732395;3256.4952432372784;3308.338332333543;244462.55374462588;246755;247021;247390;247896;52686.47313526893;53179;53202.46797531975;53209;53216.20175697368;31979.360412791615;32802.67197327996;32848.55090215493;34696.479552806726;34742.30515389678;12565.994720422344;12712.364381780873;12712.55506057302;12724.93637531825;12737.87921959126;9441.575129119206;9515.429074255428;9524.619015239452;9527.714168574954;9528.857067143997;17395.47813565595;17493.562660933323;17501.7374739379;17509.474715758548;17525.7371139433;6300.779472718433;6344.333844946306;6385.584936979081;6463.8060858173385;6622.106015687917;736.3225832234357;824.5547404401676;833.2167762303416;842.5787106446777;883.0948278015086;25167.652859960624;26520;26946.865265673547;27365.45269094647;27367.863160684068;885.2519620920312;889.2930120554175;906.0214967834722;974.605284859633;1009.6415772400838;13729.931350343184;14221.776256637839;14519.475455077276;14570.125792452487;14853.925730371278;283001;286277;287482;287782;288228;46284.305735414;46779.29831052469;46830;46870.5312946873;46938.76530617325;1088.907442867365;1106.6071544601712;1115.576081089181;1134.733337665648;1145.4330106597288;24831.130910418047;25142.24573262805;25154.24537263885;25177.244682659548;25322.441960447297;40129.598704013755;44766.77616611896;46163.07673846437;46286;51097;327583;330323;330614;330744;331001;36640;37092.443613345284;37119.44320835135;37352.62647373491;37872;40587.59412405838;40661.39007914943;40724.59275407327;40867;41839.32642694258;34753.30493390169;34849.30301394009;35172.29655406826;35288.82355588206;35597.288054238255;35120.47319290161;35148;35292;35405.82297088601;35617;26374.86812565925;27278;30508;34767.30465390729;35314.11714707153;30539.694603053686;32795.34409311848;33101.834490827394;33150.336993259516;33517.83241083779;22127.668084978417;22861.42846428786;23199.420014499774;23266.883665581565;24414.511709766062 08:52:57 INFO - PROCESS | 30429 | |2;jquery.html;328.3285680782799;337.5274615538246;340.2124082748437;342.80974059397033;362.1688225522426;10181.389116653007;10894.40080795557;15248.618784530407;15955.282012309444;17152.399666011694;15470.458533951314;15598.84401155988;15723;16569.50291491254;16869.325226990906;3498.4052711039058;4755.429348478187;4973.079980203655;4983.576396006344;4992.850214493571;4879.097366987101;4914.680545764531;4938.2098864181735;4941.629377796662;4949.653524253304;4924.433690125627;4924.433690125646;4929.964707411448;4930;4931.580815630676;5186.092433824085;5430.972845135769;5455.536279416255;5527.060399732055;5529.474699903502;5212.609054320941;5216.139337009389;5337.653052551611;5340.065488539529;5341.011912796145;11556.306621602647;11774.764504709943;11788.823167652492;11792.35142067186;11793;1752.9386471473438;1791.2297711983842;1959.6276707425543;2088.905999230038;2202.942587557965;8818.294536437134;8996;9241.861372079424;9285.978542360335;10837.566497340096;1706.67573161099;1726.6891959447294;1738.8521975632086;1773.3803442033445;1803.9729404058949;65589.3441065588;69514.65242673804;70538.29461705369;70652;71794.28205717928;9803.852942205873;9914.355566888129;9981.80036399268;10090.49547522621;10265.230107741949;13666.18002919828;13674.453021879013;13702.794458082937;13707.246101464316;13723.764861162543;6496.187976502937;6806.183258008971;6822.522423430312;6965.094537710166;7009;6196.8760624787255;6230.626162430269;6447.742090316428;6463.57986730861;6482.67586620667;4095.8122144578333;4165.333546632524;4316.927874620137;4374.300111982067;4436.534163912807;1779.4394765648779;1796.7664203653703;1803.774528183977;1846.6952952762645;1851.268748844226;759.8898159766803;768.692522990797;775.6393277126164;819.9795005124801;869.1395518436829;15748.68502629964;16557.91721041387;16893.577660558585;17205.311787528608;17722.822771772375;810.4124509730516;818.5307373265003;829.987280843951;830.6137645994642;853.906070332263;8891.244244239311;9739.366941148803;9753.170980466597;9768.365056271461;9826.115649591427;270259;271136;398050;399451;402566;81227.5938620303;82354;83347.5832620833;83616;84053.57973210094;874.8119154381839;874.9475031498131;903.1916434790957;905.2034209895251;905.4748246017294;15608.609784755017;15645.687086258438;16309.59226019359;16393.34426622922;16614.66770664604;36160;36967.67290943828;37308.81345593255;37330.62669373272;38058.048548785395;47847.52152478431;50052.499475004784;50889;53506.73246633742;56868.43131568631;7253.222960374531;7491.250874912683;7493.43799215072;7526.811829704301;7647.349975251944;9599.136077753035;11293.548258069584;11414.714632134263;11534.711632209262;11689.240199387013;10332.225083118947;10432.895671043192;10630.30902991303;10742.3017503862;10819.837702434312;9665.323427360017;9807.9019209807;9907.108360247612;10297.433641149808;10563;9392.812143757223;10010.149137323118;10061.849072264069;10425.478726063819;10447.895521044997;7393.741219057307;7550.811229719301;7590.240975902366;7623;7710.845783084194;8734.475931444134;10590.152787777113;10680.305780124267;10772.784544309226;10997.945010274898 08:52:57 INFO - PROCESS | 30429 | |3;mootools.html;1191.8152686333622;1328.242901546119;1338.6586420462784;1392.986070139299;1632.1839080459777;6326.683665816708;7529.247075292475;7782.455228134033;7797.415193860462;7989.760307190779;7815.335696465807;7879.527228366302;7887.5661838599;7888.447808653396;7895.802604934879;2066.514369123259;2091;2091.2471510256296;2092.3199960013058;2094.4449720823995;2047.8566500344982;2071.968920466187;2080.209520382253;2091.069474084033;2092.654711972523;2107.9789202108013;2112.2923820520145;2122.3208573256566;2126.2451829600423;2127.840411969101;2084.468460542552;2086.739157605299;2087.405089549479;2088.6240476714183;2092.4768807797973;2039.7858224886322;2062.669972804344;2073.154892145976;2075.2529089527757;2078.9168433262653;7527.209642987517;7747.690092396298;7808.570528620923;7845.843083138362;7852.764417067498;4193.182329445759;4411.580899814512;4413.7793110344355;4415;4417.955820441786;2658.348704567374;2781.763550098244;2836.092450415868;2851.957220641692;2853.2866783304175;875.2166810704448;889.2308153447286;893.4996402014827;913.488446469979;923.4736200365794;10460.633877814316;10545.736356590993;10560.419176945265;10570.101541368993;10604.522796474177;3656.542932133483;3788.659020688096;3836.5971572984995;3957.584453632385;3962.2075584883137;8061.355091592659;8069.515829050159;8081.111077781439;8085;8094.15011423792;4171.833126674899;4178.8328466860985;4181.289180839264;4182.477190351206;4188.5811418857875;3435.3301106284534;3533.8939831805087;3826.8086595670106;3910.4916360872903;3912.7847968361443;3502.4571191465366;3613.728970327236;3677.3013127505687;3688.5020522229693;3726.366517691999;1124.0782558302114;1141.7031571791395;1143.5025763792776;1154.4054811771944;1158.3513232589607;587.1075964533885;664.9102371179926;681.0057316318132;719.8272414620453;746.9095121123113;4901.1913034349645;4909.484504127086;4933.087378834927;4987.900241995139;5224;380.61367711772573;383.51868405151356;389.5675799862207;390.00354095286247;391.9784411857375;3315.767896247288;3331.51693004513;3359.932801344008;3456.6197718250974;3565.4117070683046;9045.909540904508;9399.389039712396;9434.528273586293;9439.811203775886;9449.669261575811;9385;9385.624575016924;9398.95300523493;9410.153086222273;9413.294002949806;7174.210836807947;7219.0976127984;7244.38422734063;7258.0927384076995;7264.273572642694;4859.1010663027455;4926.39862584139;5065.493450654905;5092.414372347227;5143.4085080216255;8499.95750021246;8650.610722517376;8789.824203516022;8804.075572065098;8813.515256660945;8662.436941599028;8912.955435222782;8924.375293729376;8927.508987005776;8980.685676001309;5651.971740141273;5746.626469279484;6655.434288085567;6711.865762684816;6717.227518835396;6663.36698013688;6831.59010459374;6860.965695171492;6976.790696279119;6986.510944233854;6503.967480162569;6535.477161826947;6704.631245281556;6824.283450237852;6846.554973926679;6483.4164925156965;6543.5419520633095;6618.70215840298;6659.134312539339;6665.533412661067;6169;6251.499880009679;6283.8114856554375;6327.272363678236;6332.145160403286;4371.038371558252;4441.267190913463;4507.2112380333965;4520.547945205453;4523.7964291606295;4272.935905961475;4290.12052529237;4328.43730315057;4479.238529449936;4499.977500112609 08:52:57 INFO - PROCESS | 30429 | |4;prototype.html;287.17723721537794;293.6564219862761;294.7391558470754;303.0982826092374;303.50680144764755;4812.663113582051;4834.274858771186;4836.065573770494;4848.63635227358;4864.124457597635;4687.3672054272665;4710.317004034413;4719.646026548014;4810.567048965592;4826.058918510892;3469.9132521687034;3574.892753217395;3654.926901461969;3690.1697118148472;3698.408254679252;3713.795741234231;3714;3720.3675375186285;3740.5137332146783;3750.343689854278;3681.3189559931366;3688.5758137814228;3722.609126041767;3722.7207959403154;3723.2925744108534;3503.8248087595643;3587.784732916007;3608.2963822054708;3685.1339935115493;3689.5572531296148;3246.5617141685807;3249.041532747845;3250.0737289872272;3251.951220731691;3267.15054085937;4575.885602859922;4626.242028029361;4639.350490931239;4645;4649.604783593365;4116.876493705194;4198.311710948953;4239.618434340924;4269.765162916038;4286.657067434598;4951;4961.751912404366;4973.825916092956;4981.9252711209365;4997.625178111656;3575.106223444139;3601.4417765246167;3609.1157666371646;3634.909127271813;3638.417853143511;5237.816676416307;5244.895102097975;5257.342832145981;5263.31576895005;5267.446918073624;3400.25194457219;3572.392693242155;3574.0707416071486;3600.4599310103695;3600.567931848195;3625.7643253188457;3633.7274704397278;3634;3643.6720695137565;3647.6472675124396;4164.770937598461;4170.291050521419;4175.603317684815;4181.268278051329;4191.874243772691;4841.540053694894;4995.825146119941;5027.84916452507;5028.899422011539;5033.949660503421;1243.564752336675;1257.1451413039038;1258.4966013594635;1258.6916205529703;1265.215566348851;779.6491578789454;793.484235247094;802.9481379393014;815.2744057788573;818.2063398503442;4254.617084462413;4333.393324934512;4403.559644035635;4493.483249426293;4498.752568608758;5146.176611742103;5146.228065790161;5148.227765835155;5186.196139598293;5195.922061169085;4459;4459.843905463294;4479.55204479556;4481.910361792746;4493.101379724003;2642.63003179555;2735.275152084699;2745.492083964473;2745.7254274572383;2754.380264440525;4819.397575303087;4846.273059041101;4862.270659401118;4903.117438860968;4906.239532872411;5006.347191367858;5218.347706536683;5224.52979231871;5276.076686579833;5283.233931079972;4813.614910807197;4844.394450693663;4850.79288923546;4863.878403039952;4888.926666100011;5139.717315547681;5157.716325602128;5161.535461808305;5177.223416487557;5187.377514698261;4768.308595253599;5002.499750024968;5003.449620541664;5052.1663925451885;5057.595392368676;4892.339534162985;4918.975405122951;4929.482404347636;4930.975345123252;4933.925991110064;3629.60074391822;3632.8011756120945;3648.142686468731;3654.8355324009954;3667.541557305337;5078.873028174326;5184.222366645034;5192.221166825007;5223.112070948024;5256.605754568346;4963.677360971526;4978.576820970258;4986.900261994667;4990.500949905126;4999.850004499871;4971.105201063843;4986.401631804207;4990.72551009698;4991.376077990251;5007.1487847065355;4732.881677958078;4928.954483889289;4930.087933732271;4937.802487900443;4941.604671626334;4785.928211076767;4913.975430122827;5003.8498845033255;5007.749612519432;5034.295198672262;4836.01723293448;4951.3810773653295;4953.554180123662;4969;4970.676906001098 08:52:57 INFO - PROCESS | 30429 | |5;yui.html;564.9491545760881;583.6352279825109;626.1296797451544;655.9147310849589;657.1818086482331;11093.44532773361;11647.650570482889;11662.883371166286;11922.523099076026;11958.103142264343;11660.650180494578;11706.94146529266;11723.003544698711;11733.823992640097;11741.29552226867;576.7404667899441;593.0599999001588;712.8182313510074;716.3767522255645;737.0565675934786;739.0909181706504;749.8087987563164;749.947503674743;750.2310132114599;750.5234176298063;788.329919568368;788.8146285622875;789.9723509677162;790.3598085550723;790.5888937752366;612.7089632424608;629.3549112160027;631.5421319543341;633.6388258692547;788.9013873265842;464.7258117710567;547.4935684491829;562.0529407947621;562.15115176084;566.6826577116827;12027.699307517294;12047.759044819142;12059.939700301442;12062.276263424223;12074.517019319217;11839.763204735857;12228.571999980048;12317.322547259897;12566.497340106385;13323.067385283033;9563.091506306959;9675.371100878421;9707.951460242724;9719.076687714727;11458.94270528642;4074.4295798588223;4096.549379568245;4192.161567686475;4208.642265407444;4211.157768446293;57591.84816303692;58488.41511584872;59076.70461647707;59522.40477595212;60263.096053558795;9575.329726919188;9678.56446459911;9688.418694878188;9771.267154963407;10205.897941020643;16342.836571634369;16346.346146154021;16359.591010224602;16363.100029498253;16374.426895058616;6378.872422551523;6505.837354066091;6517.283098859121;6522.5760325578685;6533.640649764214;3637.4907512948207;3761.4545890845675;3769.4345848123003;3785.6971442284553;3790.0524868782804;2478.677771889643;2581.4449893273036;2588.7670109690216;2593.4553743713655;2596.40282734972;446.2369348414183;468.4308565093428;474.57051368511554;474.928760685893;475.3677608780314;445.3853681918931;477.5367893143645;489.9363082799285;515.5205658737335;520.6615699795163;6840.6921688524135;7145.535540189871;7338;7420.5547667140145;7445.553266804009;404.3570722551158;442.99882266078896;466.9136209801198;483.79922332232434;514.2800079888111;3559.7864128152396;3561.3767590671528;3683.7421380503106;3701.818472164047;3771.4719939207985;59524.10713839296;60788.69605651943;74538;104367.4781626087;104645.47677261717;53108;68567.65716171387;77098.6145069271;87717.56141219253;88678;74785;75888.48223035509;77819.22180778233;78751;81546.59226703946;8226.876596851173;8300.87548686758;8391.832163356821;8612.78468038279;8636.093210212837;30562.541561876144;32016;39044.68120209814;39627.405588916765;41736.37395439132;54256.914861703335;57008.714956424956;58164.70917645385;60822.69588652028;61501.38498614957;10448.738781530523;10592.788144237225;10928.235023548594;11020.724481888017;11121.443927803739;12426.5650702225;12495;12541.31022793755;12580.433880475584;13559.457621695416;11484.655460336204;11735.706607334885;12244.816327754912;12254.142210045567;12612;11160;11160.549128613553;11804.17370784037;12157.817632735692;12180.45187966526;11051.944740276247;11120.332780033224;11312.095032397554;12122;12161.209521381083;9366.391184572982;9450.291228158054;9654.517274136406;9846.044563710897;10220.386776793417;8773.29813614922;9109.407888487227;9219.76950576241;9970.55132519024;10203.7449063774 08:52:57 INFO - PROCESS | 30429 | __end_tp_report 08:52:57 INFO - PROCESS | 30429 | __start_cc_report 08:52:57 INFO - PROCESS | 30429 | _x_x_mozilla_cycle_collect,947 08:52:57 INFO - PROCESS | 30429 | __end_cc_report 08:52:57 INFO - PROCESS | 30429 | __startTimestamp1474127577193__endTimestamp 08:52:57 INFO - PROCESS | 30429 | 08:52:57 INFO - PROCESS | 30429 | ------- Summary: start ------- 08:52:57 INFO - PROCESS | 30429 | Number of tests: 6 08:52:57 INFO - PROCESS | 30429 | 08:52:57 INFO - PROCESS | 30429 | [#0] dojo.html Cycles:165 Average:4652.45 Median:4800.59 stddev:490.62 (10.2%) stddev-sans-first:464.78 08:52:57 INFO - PROCESS | 30429 | Values: 2593.4 2604.2 2640.3 2645.5 2660.5 4622.5 4682.9 4704.3 4723.4 4731.5 4741.4 4747.1 4751.0 4751.2 4760.3 4266.7 4289.6 4316.2 4337.4 4345.9 4337.4 4349.8 4390.6 4410.0 4423.8 4340.5 4408.1 4418.5 4418.7 4480.7 4378.2 4490.8 4492.0 4495.1 4499.6 4204.7 4339.9 4343.2 4379.5 4394.5 4621.5 4638.5 4679.8 4705.6 4725.2 4939.7 4941.4 4942.1 4947.8 4958.2 5026.1 5044.3 5046.8 5050.7 5052.2 4617.3 4650.0 4684.5 4695.1 4769.4 5160.2 5180.1 5183.6 5232.4 5242.7 4951.3 4972.1 4972.8 4973.6 5031.6 4883.9 4940.3 4996.5 5062.2 5068.5 4965.0 4995.4 5034.3 5065.7 5066.2 4986.6 4989.4 4992.9 5004.6 5062.1 4053.6 4090.4 4196.5 4212.5 4253.9 3633.0 3646.9 3690.3 3696.7 3750.5 4347.5 4349.6 4351.7 4359.8 4407.2 5026.4 5027.1 5034.5 5046.5 5077.5 4217.4 4279.5 4285.4 4292.0 4312.9 4415.3 4418.1 4420.8 4446.0 4467.1 4692.9 4693.6 4705.0 4710.4 4765.0 4898.3 4926.0 4947.9 4969.6 5009.7 4800.6 4809.4 4817.6 4833.5 4852.2 5003.8 5004.9 5006.5 5011.3 5057.6 4919.0 4963.9 4975.8 5003.4 5075.7 4910.7 4911.6 4927.0 4928.7 4977.3 4898.2 4907.2 4908.3 4914.1 4971.9 4642.4 4711.4 4836.7 4855.6 4907.5 4946.3 4974.7 4980.9 5048.6 5064.3 4872.0 4873.9 4883.0 4935.2 4945.6 08:52:57 INFO - PROCESS | 30429 | 08:52:57 INFO - PROCESS | 30429 | [#1] ext.html Cycles:180 Average:43660.70 Median:35230.56 stddev:75989.66 (215.7%) stddev-sans-first:76133.93 08:52:57 INFO - PROCESS | 30429 | Values: 561.5 564.0 564.6 583.7 587.2 27800.2 28538.0 30519.2 30531.4 30543.0 29785.0 39231.0 40346.0 40395.4 43859.6 7504.2 7609.7 7619.4 7628.4 7635.2 7393.6 7496.2 7502.6 7506.6 7511.1 7513.0 7530.2 7548.2 7552.3 7557.1 7475.6 7511.9 7533.8 7553.8 7578.6 7576.1 7632.2 7633.1 7635.1 7638.8 37511.6 37880.6 37884.4 37895.0 37924.8 2788.9 2796.4 2904.4 2966.2 3005.7 27908.2 28221.9 28490.0 28895.1 29122.3 3178.5 3183.4 3231.1 3256.5 3308.3 244462.6 246755.0 247021.0 247390.0 247896.0 52686.5 53179.0 53202.5 53209.0 53216.2 31979.4 32802.7 32848.6 34696.5 34742.3 12566.0 12712.4 12712.6 12724.9 12737.9 9441.6 9515.4 9524.6 9527.7 9528.9 17395.5 17493.6 17501.7 17509.5 17525.7 6300.8 6344.3 6385.6 6463.8 6622.1 736.3 824.6 833.2 842.6 883.1 25167.7 26520.0 26946.9 27365.5 27367.9 885.3 889.3 906.0 974.6 1009.6 13729.9 14221.8 14519.5 14570.1 14853.9 283001.0 286277.0 287482.0 287782.0 288228.0 46284.3 46779.3 46830.0 46870.5 46938.8 1088.9 1106.6 1115.6 1134.7 1145.4 24831.1 25142.2 25154.2 25177.2 25322.4 40129.6 44766.8 46163.1 46286.0 51097.0 327583.0 330323.0 330614.0 330744.0 331001.0 36640.0 37092.4 37119.4 37352.6 37872.0 40587.6 40661.4 40724.6 40867.0 41839.3 34753.3 34849.3 35172.3 35288.8 35597.3 35120.5 35148.0 35292.0 35405.8 35617.0 26374.9 27278.0 30508.0 34767.3 35314.1 30539.7 32795.3 33101.8 33150.3 33517.8 22127.7 22861.4 23199.4 23266.9 24414.5 08:52:57 INFO - PROCESS | 30429 | 08:52:57 INFO - PROCESS | 30429 | [#2] jquery.html Cycles:180 Average:22929.49 Median:4896.89 stddev:59023.05 (1205.3%) stddev-sans-first:59164.23 08:52:57 INFO - PROCESS | 30429 | Values: 328.3 337.5 340.2 342.8 362.2 10181.4 10894.4 15248.6 15955.3 17152.4 15470.5 15598.8 15723.0 16569.5 16869.3 3498.4 4755.4 4973.1 4983.6 4992.9 4879.1 4914.7 4938.2 4941.6 4949.7 4924.4 4924.4 4930.0 4930.0 4931.6 5186.1 5431.0 5455.5 5527.1 5529.5 5212.6 5216.1 5337.7 5340.1 5341.0 11556.3 11774.8 11788.8 11792.4 11793.0 1752.9 1791.2 1959.6 2088.9 2202.9 8818.3 8996.0 9241.9 9286.0 10837.6 1706.7 1726.7 1738.9 1773.4 1804.0 65589.3 69514.7 70538.3 70652.0 71794.3 9803.9 9914.4 9981.8 10090.5 10265.2 13666.2 13674.5 13702.8 13707.2 13723.8 6496.2 6806.2 6822.5 6965.1 7009.0 6196.9 6230.6 6447.7 6463.6 6482.7 4095.8 4165.3 4316.9 4374.3 4436.5 1779.4 1796.8 1803.8 1846.7 1851.3 759.9 768.7 775.6 820.0 869.1 15748.7 16557.9 16893.6 17205.3 17722.8 810.4 818.5 830.0 830.6 853.9 8891.2 9739.4 9753.2 9768.4 9826.1 270259.0 271136.0 398050.0 399451.0 402566.0 81227.6 82354.0 83347.6 83616.0 84053.6 874.8 874.9 903.2 905.2 905.5 15608.6 15645.7 16309.6 16393.3 16614.7 36160.0 36967.7 37308.8 37330.6 38058.0 47847.5 50052.5 50889.0 53506.7 56868.4 7253.2 7491.3 7493.4 7526.8 7647.3 9599.1 11293.5 11414.7 11534.7 11689.2 10332.2 10432.9 10630.3 10742.3 10819.8 9665.3 9807.9 9907.1 10297.4 10563.0 9392.8 10010.1 10061.8 10425.5 10447.9 7393.7 7550.8 7590.2 7623.0 7710.8 8734.5 10590.2 10680.3 10772.8 10997.9 08:52:57 INFO - PROCESS | 30429 | 08:52:57 INFO - PROCESS | 30429 | [#3] mootools.html Cycles:180 Average:4938.00 Median:4880.15 stddev:2838.31 (58.2%) stddev-sans-first:2832.31 08:52:57 INFO - PROCESS | 30429 | Values: 1191.8 1328.2 1338.7 1393.0 1632.2 6326.7 7529.2 7782.5 7797.4 7989.8 7815.3 7879.5 7887.6 7888.4 7895.8 2066.5 2091.0 2091.2 2092.3 2094.4 2047.9 2072.0 2080.2 2091.1 2092.7 2108.0 2112.3 2122.3 2126.2 2127.8 2084.5 2086.7 2087.4 2088.6 2092.5 2039.8 2062.7 2073.2 2075.3 2078.9 7527.2 7747.7 7808.6 7845.8 7852.8 4193.2 4411.6 4413.8 4415.0 4418.0 2658.3 2781.8 2836.1 2852.0 2853.3 875.2 889.2 893.5 913.5 923.5 10460.6 10545.7 10560.4 10570.1 10604.5 3656.5 3788.7 3836.6 3957.6 3962.2 8061.4 8069.5 8081.1 8085.0 8094.2 4171.8 4178.8 4181.3 4182.5 4188.6 3435.3 3533.9 3826.8 3910.5 3912.8 3502.5 3613.7 3677.3 3688.5 3726.4 1124.1 1141.7 1143.5 1154.4 1158.4 587.1 664.9 681.0 719.8 746.9 4901.2 4909.5 4933.1 4987.9 5224.0 380.6 383.5 389.6 390.0 392.0 3315.8 3331.5 3359.9 3456.6 3565.4 9045.9 9399.4 9434.5 9439.8 9449.7 9385.0 9385.6 9399.0 9410.2 9413.3 7174.2 7219.1 7244.4 7258.1 7264.3 4859.1 4926.4 5065.5 5092.4 5143.4 8500.0 8650.6 8789.8 8804.1 8813.5 8662.4 8913.0 8924.4 8927.5 8980.7 5652.0 5746.6 6655.4 6711.9 6717.2 6663.4 6831.6 6861.0 6976.8 6986.5 6504.0 6535.5 6704.6 6824.3 6846.6 6483.4 6543.5 6618.7 6659.1 6665.5 6169.0 6251.5 6283.8 6327.3 6332.1 4371.0 4441.3 4507.2 4520.5 4523.8 4272.9 4290.1 4328.4 4479.2 4500.0 08:52:57 INFO - PROCESS | 30429 | 08:52:57 INFO - PROCESS | 30429 | [#4] prototype.html Cycles:180 Average:4145.41 Median:4798.25 stddev:1217.14 (25.4%) stddev-sans-first:1185.60 08:52:57 INFO - PROCESS | 30429 | Values: 287.2 293.7 294.7 303.1 303.5 4812.7 4834.3 4836.1 4848.6 4864.1 4687.4 4710.3 4719.6 4810.6 4826.1 3469.9 3574.9 3654.9 3690.2 3698.4 3713.8 3714.0 3720.4 3740.5 3750.3 3681.3 3688.6 3722.6 3722.7 3723.3 3503.8 3587.8 3608.3 3685.1 3689.6 3246.6 3249.0 3250.1 3252.0 3267.2 4575.9 4626.2 4639.4 4645.0 4649.6 4116.9 4198.3 4239.6 4269.8 4286.7 4951.0 4961.8 4973.8 4981.9 4997.6 3575.1 3601.4 3609.1 3634.9 3638.4 5237.8 5244.9 5257.3 5263.3 5267.4 3400.3 3572.4 3574.1 3600.5 3600.6 3625.8 3633.7 3634.0 3643.7 3647.6 4164.8 4170.3 4175.6 4181.3 4191.9 4841.5 4995.8 5027.8 5028.9 5033.9 1243.6 1257.1 1258.5 1258.7 1265.2 779.6 793.5 802.9 815.3 818.2 4254.6 4333.4 4403.6 4493.5 4498.8 5146.2 5146.2 5148.2 5186.2 5195.9 4459.0 4459.8 4479.6 4481.9 4493.1 2642.6 2735.3 2745.5 2745.7 2754.4 4819.4 4846.3 4862.3 4903.1 4906.2 5006.3 5218.3 5224.5 5276.1 5283.2 4813.6 4844.4 4850.8 4863.9 4888.9 5139.7 5157.7 5161.5 5177.2 5187.4 4768.3 5002.5 5003.4 5052.2 5057.6 4892.3 4919.0 4929.5 4931.0 4933.9 3629.6 3632.8 3648.1 3654.8 3667.5 5078.9 5184.2 5192.2 5223.1 5256.6 4963.7 4978.6 4986.9 4990.5 4999.9 4971.1 4986.4 4990.7 4991.4 5007.1 4732.9 4929.0 4930.1 4937.8 4941.6 4785.9 4914.0 5003.8 5007.7 5034.3 4836.0 4951.4 4953.6 4969.0 4970.7 08:52:57 INFO - PROCESS | 30429 | 08:52:57 INFO - PROCESS | 30429 | [#5] yui.html Cycles:180 Average:16425.00 Median:476.45 stddev:23315.78 (4893.6%) stddev-sans-first:23350.77 08:52:57 INFO - PROCESS | 30429 | Values: 564.9 583.6 626.1 655.9 657.2 11093.4 11647.7 11662.9 11922.5 11958.1 11660.7 11706.9 11723.0 11733.8 11741.3 576.7 593.1 712.8 716.4 737.1 739.1 749.8 749.9 750.2 750.5 788.3 788.8 790.0 790.4 790.6 612.7 629.4 631.5 633.6 788.9 464.7 547.5 562.1 562.2 566.7 12027.7 12047.8 12059.9 12062.3 12074.5 11839.8 12228.6 12317.3 12566.5 13323.1 9563.1 9675.4 9708.0 9719.1 11458.9 4074.4 4096.5 4192.2 4208.6 4211.2 57591.8 58488.4 59076.7 59522.4 60263.1 9575.3 9678.6 9688.4 9771.3 10205.9 16342.8 16346.3 16359.6 16363.1 16374.4 6378.9 6505.8 6517.3 6522.6 6533.6 3637.5 3761.5 3769.4 3785.7 3790.1 2478.7 2581.4 2588.8 2593.5 2596.4 446.2 468.4 474.6 474.9 475.4 445.4 477.5 489.9 515.5 520.7 6840.7 7145.5 7338.0 7420.6 7445.6 404.4 443.0 466.9 483.8 514.3 3559.8 3561.4 3683.7 3701.8 3771.5 59524.1 60788.7 74538.0 104367.5 104645.5 53108.0 68567.7 77098.6 87717.6 88678.0 74785.0 75888.5 77819.2 78751.0 81546.6 8226.9 8300.9 8391.8 8612.8 8636.1 30562.5 32016.0 39044.7 39627.4 41736.4 54256.9 57008.7 58164.7 60822.7 61501.4 10448.7 10592.8 10928.2 11020.7 11121.4 12426.6 12495.0 12541.3 12580.4 13559.5 11484.7 11735.7 12244.8 12254.1 12612.0 11160.0 11160.5 11804.2 12157.8 12180.5 11051.9 11120.3 11312.1 12122.0 12161.2 9366.4 9450.3 9654.5 9846.0 10220.4 8773.3 9109.4 9219.8 9970.6 10203.7 08:52:57 INFO - PROCESS | 30429 | -------- Summary: end -------- 08:52:57 INFO - PROCESS | 30429 | 08:52:58 INFO - TEST-INFO | 30429: exit 0 08:52:58 INFO - TEST-OK | dromaeo_css | took 1120927ms 08:52:58 INFO - TEST-START | kraken 08:52:58 INFO - operating with platform_type : linux_ 08:52:58 INFO - Initialising browser for kraken test... 08:52:58 INFO - TEST-INFO | started process 30737 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHdHeV0/profile http://localhost:47837/getInfo.html) 08:53:02 INFO - PROCESS | 30737 | __metrics Screen width/height:1600/1200 08:53:02 INFO - PROCESS | 30737 | colorDepth:24 08:53:02 INFO - PROCESS | 30737 | Browser inner width/height: 1024/697 08:53:02 INFO - PROCESS | 30737 | __metrics 08:53:03 INFO - PROCESS | 30737 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:53:03 INFO - PROCESS | 30737 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:53:03 INFO - PROCESS | 30737 | console.error: PushService: 08:53:03 INFO - PROCESS | 30737 | stateChangeProcessEnqueue: Error transitioning state 08:53:03 INFO - PROCESS | 30737 | UnknownError 08:53:04 INFO - TEST-INFO | 30737: exit 0 08:53:04 INFO - Browser initialized. 08:53:04 INFO - Running cycle 1/1 for kraken test... 08:53:04 INFO - TEST-INFO | started process 30820 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHdHeV0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:53:16 INFO - PROCESS | 30820 | RSS: Main: 174931968 08:53:16 INFO - PROCESS | 30820 | 08:53:19 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47837/tests/kraken/driver.html?testName=audio-beat-detection) 08:53:20 INFO - PROCESS | 30820 | RSS: Main: 242397184 08:53:20 INFO - PROCESS | 30820 | 08:53:23 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47837/tests/kraken/driver.html?testName=audio-dft) 08:53:23 INFO - PROCESS | 30820 | RSS: Main: 218251264 08:53:23 INFO - PROCESS | 30820 | 08:53:27 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47837/tests/kraken/driver.html?testName=audio-fft) 08:53:27 INFO - PROCESS | 30820 | RSS: Main: 300208128 08:53:27 INFO - PROCESS | 30820 | 08:53:30 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47837/tests/kraken/driver.html?testName=audio-oscillator) 08:53:30 INFO - PROCESS | 30820 | RSS: Main: 209670144 08:53:30 INFO - PROCESS | 30820 | 08:53:32 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47837/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:53:33 INFO - PROCESS | 30820 | RSS: Main: 213270528 08:53:33 INFO - PROCESS | 30820 | 08:53:36 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47837/tests/kraken/driver.html?testName=imaging-darkroom) 08:53:37 INFO - PROCESS | 30820 | RSS: Main: 249409536 08:53:37 INFO - PROCESS | 30820 | 08:53:40 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47837/tests/kraken/driver.html?testName=imaging-desaturate) 08:53:41 INFO - PROCESS | 30820 | RSS: Main: 249176064 08:53:41 INFO - PROCESS | 30820 | 08:53:44 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47837/tests/kraken/driver.html?testName=json-parse-financial) 08:53:44 INFO - PROCESS | 30820 | RSS: Main: 249176064 08:53:44 INFO - PROCESS | 30820 | 08:53:46 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47837/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:53:47 INFO - PROCESS | 30820 | RSS: Main: 211251200 08:53:47 INFO - PROCESS | 30820 | 08:53:49 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47837/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:53:49 INFO - PROCESS | 30820 | RSS: Main: 218542080 08:53:49 INFO - PROCESS | 30820 | 08:53:51 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47837/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:53:52 INFO - PROCESS | 30820 | RSS: Main: 222507008 08:53:52 INFO - PROCESS | 30820 | 08:53:55 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47837/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:53:56 INFO - PROCESS | 30820 | RSS: Main: 223088640 08:53:56 INFO - PROCESS | 30820 | 08:53:58 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47837/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:53:59 INFO - PROCESS | 30820 | RSS: Main: 222138368 08:53:59 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | Cycle 1(1): loaded http://localhost:47837/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47837/tests/kraken/driver.html?testName=ai-astar) 08:54:01 INFO - PROCESS | 30820 | RSS: Main: 273346560 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | __start_tp_report 08:54:01 INFO - PROCESS | 30820 | _x_x_mozilla_page_load 08:54:01 INFO - PROCESS | 30820 | _x_x_mozilla_page_load_details 08:54:01 INFO - PROCESS | 30820 | |i|pagename|runs| 08:54:01 INFO - PROCESS | 30820 | |0;ai-astar;113;116;114;117;113;116;115;115;114;115 08:54:01 INFO - PROCESS | 30820 | |1;audio-beat-detection;157;125;129;165;130;125;127;126;160;127 08:54:01 INFO - PROCESS | 30820 | |2;audio-dft;160;161;161;161;161;161;162;161;162;161 08:54:01 INFO - PROCESS | 30820 | |3;audio-fft;77;77;77;108;78;77;77;77;104;76 08:54:01 INFO - PROCESS | 30820 | |4;audio-oscillator;84;82;118;84;84;85;107;84;83;110 08:54:01 INFO - PROCESS | 30820 | |5;imaging-gaussian-blur;116;117;117;117;117;117;117;116;116;117 08:54:01 INFO - PROCESS | 30820 | |6;imaging-darkroom;147;146;145;147;146;147;147;148;146;149 08:54:01 INFO - PROCESS | 30820 | |7;imaging-desaturate;95;95;96;96;96;96;96;96;96;95 08:54:01 INFO - PROCESS | 30820 | |8;json-parse-financial;65;64;64;64;64;67;67;66;65;66 08:54:01 INFO - PROCESS | 30820 | |9;json-stringify-tinderbox;67;66;66;67;66;67;68;66;67;67 08:54:01 INFO - PROCESS | 30820 | |10;stanford-crypto-aes;82;82;82;92;83;83;82;82;82;82 08:54:01 INFO - PROCESS | 30820 | |11;stanford-crypto-ccm;137;141;131;131;132;140;131;131;171;136 08:54:01 INFO - PROCESS | 30820 | |12;stanford-crypto-pbkdf2;173;170;175;171;178;172;174;172;177;170 08:54:01 INFO - PROCESS | 30820 | |13;stanford-crypto-sha256-iterative;72;73;69;71;68;70;68;69;69;68 08:54:01 INFO - PROCESS | 30820 | __end_tp_report 08:54:01 INFO - PROCESS | 30820 | __start_cc_report 08:54:01 INFO - PROCESS | 30820 | _x_x_mozilla_cycle_collect,1952 08:54:01 INFO - PROCESS | 30820 | __end_cc_report 08:54:01 INFO - PROCESS | 30820 | __startTimestamp1474127641594__endTimestamp 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | ------- Summary: start ------- 08:54:01 INFO - PROCESS | 30820 | Number of tests: 14 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#0] ai-astar Cycles:10 Average:114.80 Median:115.00 stddev:1.32 (1.1%) stddev-sans-first:1.22 08:54:01 INFO - PROCESS | 30820 | Values: 113.0 116.0 114.0 117.0 113.0 116.0 115.0 115.0 114.0 115.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#1] audio-beat-detection Cycles:10 Average:137.10 Median:129.50 stddev:16.45 (12.7%) stddev-sans-first:15.79 08:54:01 INFO - PROCESS | 30820 | Values: 157.0 125.0 129.0 165.0 130.0 125.0 127.0 126.0 160.0 127.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#2] audio-dft Cycles:10 Average:161.10 Median:161.00 stddev:0.57 (0.4%) stddev-sans-first:0.44 08:54:01 INFO - PROCESS | 30820 | Values: 160.0 161.0 161.0 161.0 161.0 161.0 162.0 161.0 162.0 161.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#3] audio-fft Cycles:10 Average:82.80 Median:77.00 stddev:12.27 (15.9%) stddev-sans-first:12.84 08:54:01 INFO - PROCESS | 30820 | Values: 77.0 77.0 77.0 108.0 78.0 77.0 77.0 77.0 104.0 76.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#4] audio-oscillator Cycles:10 Average:92.10 Median:84.00 stddev:13.79 (16.4%) stddev-sans-first:14.31 08:54:01 INFO - PROCESS | 30820 | Values: 84.0 82.0 118.0 84.0 84.0 85.0 107.0 84.0 83.0 110.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.44 08:54:01 INFO - PROCESS | 30820 | Values: 116.0 117.0 117.0 117.0 117.0 117.0 117.0 116.0 116.0 117.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:1.14 (0.8%) stddev-sans-first:1.20 08:54:01 INFO - PROCESS | 30820 | Values: 147.0 146.0 145.0 147.0 146.0 147.0 147.0 148.0 146.0 149.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.44 08:54:01 INFO - PROCESS | 30820 | Values: 95.0 95.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 95.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#8] json-parse-financial Cycles:10 Average:65.20 Median:65.50 stddev:1.23 (1.9%) stddev-sans-first:1.30 08:54:01 INFO - PROCESS | 30820 | Values: 65.0 64.0 64.0 64.0 64.0 67.0 67.0 66.0 65.0 66.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#9] json-stringify-tinderbox Cycles:10 Average:66.70 Median:67.00 stddev:0.67 (1.0%) stddev-sans-first:0.71 08:54:01 INFO - PROCESS | 30820 | Values: 67.0 66.0 66.0 67.0 66.0 67.0 68.0 66.0 67.0 67.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#10] stanford-crypto-aes Cycles:10 Average:83.20 Median:82.00 stddev:3.12 (3.8%) stddev-sans-first:3.28 08:54:01 INFO - PROCESS | 30820 | Values: 82.0 82.0 82.0 92.0 83.0 83.0 82.0 82.0 82.0 82.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#11] stanford-crypto-ccm Cycles:10 Average:138.10 Median:136.50 stddev:12.20 (8.9%) stddev-sans-first:12.93 08:54:01 INFO - PROCESS | 30820 | Values: 137.0 141.0 131.0 131.0 132.0 140.0 131.0 131.0 171.0 136.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:173.20 Median:173.50 stddev:2.78 (1.6%) stddev-sans-first:2.95 08:54:01 INFO - PROCESS | 30820 | Values: 173.0 170.0 175.0 171.0 178.0 172.0 174.0 172.0 177.0 170.0 08:54:01 INFO - PROCESS | 30820 | 08:54:01 INFO - PROCESS | 30820 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.70 Median:69.50 stddev:1.77 (2.5%) stddev-sans-first:1.67 08:54:01 INFO - PROCESS | 30820 | Values: 72.0 73.0 69.0 71.0 68.0 70.0 68.0 69.0 69.0 68.0 08:54:01 INFO - PROCESS | 30820 | -------- Summary: end -------- 08:54:01 INFO - PROCESS | 30820 | 08:54:02 INFO - TEST-INFO | 30820: exit 0 08:54:02 INFO - TEST-OK | kraken | took 64559ms 08:54:02 INFO - SUITE-END | took 1185s 08:54:03 INFO - Completed test suite (00:19:45) 08:54:03 INFO - javascript benchmark 08:54:03 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2593.3775893785496, 2604.17968339973, 2640.2607269964415, 2645.5370310195713, 2660.4679064187158, 4622.514635963226, 4682.929756053658, 4704.270838020108, 4723.409573803275, 4731.479537250908, 4741.359916411284, 4747.098051370237, 4751.049790041988, 4751.168545504532, 4760.262159365296, 4266.701330906838, 4289.592488713567, 4316.201502721999, 4337.392765012901, 4345.913081738363, 4337.371081193225, 4349.804258808345, 4390.604845563898, 4410.0, 4423.845165419211, 4340.52254252032, 4408.14041261954, 4418.469783625953, 4418.668599855007, 4480.6639502037315, 4378.190034843564, 4490.842820501267, 4491.955080449186, 4495.078508905666, 4499.550044995507, 4204.684648651333, 4339.891502712426, 4343.2182207202695, 4379.5182529921685, 4394.472663280395, 4621.491635920046, 4638.466576343696, 4679.766011699401, 4705.55297246761, 4725.243960966229, 4939.703617782944, 4941.407031156248, 4942.135126352874, 4947.802087916479, 4958.20668693011, 5026.1204289249235, 5044.344235249431, 5046.798128074873, 5050.696958182521, 5052.216906379517, 4617.3304870793545, 4650.046740418206, 4684.531546845288, 4695.107929493385, 4769.356136921471, 5160.200168973815, 5180.145276029489, 5183.585313174937, 5232.424433312332, 5242.7116508591635, 4951.282064100686, 4972.136315419921, 4972.776225069881, 4973.626977976666, 5031.572316353077, 4883.877903052452, 4940.258961155855, 4996.4503904570465, 5062.190049592047, 5068.467810879804, 4965.0, 4995.400551933719, 5034.320366750442, 5065.696058236444, 5066.214736715815, 4986.576141027981, 4989.351384320088, 4992.925106123411, 5004.624653150955, 5062.139436295838, 4053.594640535982, 4090.427340172378, 4196.475440569929, 4212.53662097169, 4253.8723838284905, 3633.0, 3646.927061458756, 3690.33573956685, 3696.704263658901, 3750.512433383697, 4347.478302603708, 4349.630281426051, 4351.717138385995, 4359.825606975749, 4407.228734971367, 5026.371703537058, 5027.120253955616, 5034.496550344937, 5046.470120637354, 5077.543021128116, 4217.4306468626955, 4279.486461624562, 4285.357196420562, 4291.957080429218, 4312.89217769552, 4415.2935530315635, 4418.050119224382, 4420.778961051935, 4445.977770111193, 4467.061916997402, 4692.929606055912, 4693.647976401715, 4705.0, 4710.36410084641, 4765.023170250021, 4898.3142360068905, 4925.975370123127, 4947.925781113358, 4969.552740253394, 5009.699418034929, 4800.591949684316, 4809.350737650372, 4817.590504807131, 4833.468318485035, 4852.150873597036, 5003.77483013258, 5004.899902002013, 5006.499350064964, 5011.273365362075, 5057.620678449204, 4919.0407870464915, 4963.851084467472, 4975.800967961386, 5003.374578177728, 5075.670081444694, 4910.656254062182, 4911.607071434348, 4926.975365123151, 4928.728919909439, 4977.253411988231, 4898.2407726800975, 4907.190313598217, 4908.263760435963, 4914.090893184629, 4971.875703107451, 4642.442906851199, 4711.387519622427, 4836.661433699607, 4855.562999330077, 4907.460179380337, 4946.332245146859, 4974.651774375904, 4980.925286120783, 5048.596112310933, 5064.34163558735, 4871.975640121776, 4873.9025219496125, 4883.0, 4935.161022626234, 4945.62907781925], "value": 4620.854255505137, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [561.4638020690242, 563.9577031722621, 564.5511818104607, 583.6527266276565, 587.1808826686772, 27800.165995020157, 28538.0, 30519.237019074535, 30531.389372212543, 30543.0, 29784.957526486578, 39231.0, 40346.0, 40395.394069088914, 43859.561404385946, 7504.212057733927, 7609.657565409542, 7619.42854285928, 7628.427867909902, 7635.160132385461, 7393.630318484081, 7496.212897645751, 7502.5873576953245, 7506.62466876654, 7511.098668159829, 7513.023306970086, 7530.246975302481, 7548.169701332849, 7552.3202911737935, 7557.0931488221495, 7475.626218689071, 7511.924880751205, 7533.811654708621, 7553.811154721121, 7578.621068946586, 7576.0908690956885, 7632.198619144965, 7633.091727068233, 7635.121960974503, 7638.847223055508, 37511.624883751356, 37880.621193787985, 37884.43173352374, 37895.0, 37924.81037594822, 2788.880272027683, 2796.4267325198284, 2904.390078083584, 2966.2158790358885, 3005.6693763686194, 27908.16275511738, 28221.858890705622, 28490.0, 28895.133146005654, 29122.27194320159, 3178.475551533994, 3183.4110689522513, 3231.062991732395, 3256.4952432372784, 3308.338332333543, 244462.55374462588, 246755.0, 247021.0, 247390.0, 247896.0, 52686.47313526893, 53179.0, 53202.46797531975, 53209.0, 53216.20175697368, 31979.360412791615, 32802.67197327996, 32848.55090215493, 34696.479552806726, 34742.30515389678, 12565.994720422344, 12712.364381780873, 12712.55506057302, 12724.93637531825, 12737.87921959126, 9441.575129119206, 9515.429074255428, 9524.619015239452, 9527.714168574954, 9528.857067143997, 17395.47813565595, 17493.562660933323, 17501.7374739379, 17509.474715758548, 17525.7371139433, 6300.779472718433, 6344.333844946306, 6385.584936979081, 6463.8060858173385, 6622.106015687917, 736.3225832234357, 824.5547404401676, 833.2167762303416, 842.5787106446777, 883.0948278015086, 25167.652859960624, 26520.0, 26946.865265673547, 27365.45269094647, 27367.863160684068, 885.2519620920312, 889.2930120554175, 906.0214967834722, 974.605284859633, 1009.6415772400838, 13729.931350343184, 14221.776256637839, 14519.475455077276, 14570.125792452487, 14853.925730371278, 283001.0, 286277.0, 287482.0, 287782.0, 288228.0, 46284.305735414, 46779.29831052469, 46830.0, 46870.5312946873, 46938.76530617325, 1088.907442867365, 1106.6071544601712, 1115.576081089181, 1134.733337665648, 1145.4330106597288, 24831.130910418047, 25142.24573262805, 25154.24537263885, 25177.244682659548, 25322.441960447297, 40129.598704013755, 44766.77616611896, 46163.07673846437, 46286.0, 51097.0, 327583.0, 330323.0, 330614.0, 330744.0, 331001.0, 36640.0, 37092.443613345284, 37119.44320835135, 37352.62647373491, 37872.0, 40587.59412405838, 40661.39007914943, 40724.59275407327, 40867.0, 41839.32642694258, 34753.30493390169, 34849.30301394009, 35172.29655406826, 35288.82355588206, 35597.288054238255, 35120.47319290161, 35148.0, 35292.0, 35405.82297088601, 35617.0, 26374.86812565925, 27278.0, 30508.0, 34767.30465390729, 35314.11714707153, 30539.694603053686, 32795.34409311848, 33101.834490827394, 33150.336993259516, 33517.83241083779, 22127.668084978417, 22861.42846428786, 23199.420014499774, 23266.883665581565, 24414.511709766062], "value": 16526.487334347687, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [328.3285680782799, 337.5274615538246, 340.2124082748437, 342.80974059397033, 362.1688225522426, 10181.389116653007, 10894.40080795557, 15248.618784530407, 15955.282012309444, 17152.399666011694, 15470.458533951314, 15598.84401155988, 15723.0, 16569.50291491254, 16869.325226990906, 3498.4052711039058, 4755.429348478187, 4973.079980203655, 4983.576396006344, 4992.850214493571, 4879.097366987101, 4914.680545764531, 4938.2098864181735, 4941.629377796662, 4949.653524253304, 4924.433690125627, 4924.433690125646, 4929.964707411448, 4930.0, 4931.580815630676, 5186.092433824085, 5430.972845135769, 5455.536279416255, 5527.060399732055, 5529.474699903502, 5212.609054320941, 5216.139337009389, 5337.653052551611, 5340.065488539529, 5341.011912796145, 11556.306621602647, 11774.764504709943, 11788.823167652492, 11792.35142067186, 11793.0, 1752.9386471473438, 1791.2297711983842, 1959.6276707425543, 2088.905999230038, 2202.942587557965, 8818.294536437134, 8996.0, 9241.861372079424, 9285.978542360335, 10837.566497340096, 1706.67573161099, 1726.6891959447294, 1738.8521975632086, 1773.3803442033445, 1803.9729404058949, 65589.3441065588, 69514.65242673804, 70538.29461705369, 70652.0, 71794.28205717928, 9803.852942205873, 9914.355566888129, 9981.80036399268, 10090.49547522621, 10265.230107741949, 13666.18002919828, 13674.453021879013, 13702.794458082937, 13707.246101464316, 13723.764861162543, 6496.187976502937, 6806.183258008971, 6822.522423430312, 6965.094537710166, 7009.0, 6196.8760624787255, 6230.626162430269, 6447.742090316428, 6463.57986730861, 6482.67586620667, 4095.8122144578333, 4165.333546632524, 4316.927874620137, 4374.300111982067, 4436.534163912807, 1779.4394765648779, 1796.7664203653703, 1803.774528183977, 1846.6952952762645, 1851.268748844226, 759.8898159766803, 768.692522990797, 775.6393277126164, 819.9795005124801, 869.1395518436829, 15748.68502629964, 16557.91721041387, 16893.577660558585, 17205.311787528608, 17722.822771772375, 810.4124509730516, 818.5307373265003, 829.987280843951, 830.6137645994642, 853.906070332263, 8891.244244239311, 9739.366941148803, 9753.170980466597, 9768.365056271461, 9826.115649591427, 270259.0, 271136.0, 398050.0, 399451.0, 402566.0, 81227.5938620303, 82354.0, 83347.5832620833, 83616.0, 84053.57973210094, 874.8119154381839, 874.9475031498131, 903.1916434790957, 905.2034209895251, 905.4748246017294, 15608.609784755017, 15645.687086258438, 16309.59226019359, 16393.34426622922, 16614.66770664604, 36160.0, 36967.67290943828, 37308.81345593255, 37330.62669373272, 38058.048548785395, 47847.52152478431, 50052.499475004784, 50889.0, 53506.73246633742, 56868.43131568631, 7253.222960374531, 7491.250874912683, 7493.43799215072, 7526.811829704301, 7647.349975251944, 9599.136077753035, 11293.548258069584, 11414.714632134263, 11534.711632209262, 11689.240199387013, 10332.225083118947, 10432.895671043192, 10630.30902991303, 10742.3017503862, 10819.837702434312, 9665.323427360017, 9807.9019209807, 9907.108360247612, 10297.433641149808, 10563.0, 9392.812143757223, 10010.149137323118, 10061.849072264069, 10425.478726063819, 10447.895521044997, 7393.741219057307, 7550.811229719301, 7590.240975902366, 7623.0, 7710.845783084194, 8734.475931444134, 10590.152787777113, 10680.305780124267, 10772.784544309226, 10997.945010274898], "value": 7871.397877163947, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1191.8152686333622, 1328.242901546119, 1338.6586420462784, 1392.986070139299, 1632.1839080459777, 6326.683665816708, 7529.247075292475, 7782.455228134033, 7797.415193860462, 7989.760307190779, 7815.335696465807, 7879.527228366302, 7887.5661838599, 7888.447808653396, 7895.802604934879, 2066.514369123259, 2091.0, 2091.2471510256296, 2092.3199960013058, 2094.4449720823995, 2047.8566500344982, 2071.968920466187, 2080.209520382253, 2091.069474084033, 2092.654711972523, 2107.9789202108013, 2112.2923820520145, 2122.3208573256566, 2126.2451829600423, 2127.840411969101, 2084.468460542552, 2086.739157605299, 2087.405089549479, 2088.6240476714183, 2092.4768807797973, 2039.7858224886322, 2062.669972804344, 2073.154892145976, 2075.2529089527757, 2078.9168433262653, 7527.209642987517, 7747.690092396298, 7808.570528620923, 7845.843083138362, 7852.764417067498, 4193.182329445759, 4411.580899814512, 4413.7793110344355, 4415.0, 4417.955820441786, 2658.348704567374, 2781.763550098244, 2836.092450415868, 2851.957220641692, 2853.2866783304175, 875.2166810704448, 889.2308153447286, 893.4996402014827, 913.488446469979, 923.4736200365794, 10460.633877814316, 10545.736356590993, 10560.419176945265, 10570.101541368993, 10604.522796474177, 3656.542932133483, 3788.659020688096, 3836.5971572984995, 3957.584453632385, 3962.2075584883137, 8061.355091592659, 8069.515829050159, 8081.111077781439, 8085.0, 8094.15011423792, 4171.833126674899, 4178.8328466860985, 4181.289180839264, 4182.477190351206, 4188.5811418857875, 3435.3301106284534, 3533.8939831805087, 3826.8086595670106, 3910.4916360872903, 3912.7847968361443, 3502.4571191465366, 3613.728970327236, 3677.3013127505687, 3688.5020522229693, 3726.366517691999, 1124.0782558302114, 1141.7031571791395, 1143.5025763792776, 1154.4054811771944, 1158.3513232589607, 587.1075964533885, 664.9102371179926, 681.0057316318132, 719.8272414620453, 746.9095121123113, 4901.1913034349645, 4909.484504127086, 4933.087378834927, 4987.900241995139, 5224.0, 380.61367711772573, 383.51868405151356, 389.5675799862207, 390.00354095286247, 391.9784411857375, 3315.767896247288, 3331.51693004513, 3359.932801344008, 3456.6197718250974, 3565.4117070683046, 9045.909540904508, 9399.389039712396, 9434.528273586293, 9439.811203775886, 9449.669261575811, 9385.0, 9385.624575016924, 9398.95300523493, 9410.153086222273, 9413.294002949806, 7174.210836807947, 7219.0976127984, 7244.38422734063, 7258.0927384076995, 7264.273572642694, 4859.1010663027455, 4926.39862584139, 5065.493450654905, 5092.414372347227, 5143.4085080216255, 8499.95750021246, 8650.610722517376, 8789.824203516022, 8804.075572065098, 8813.515256660945, 8662.436941599028, 8912.955435222782, 8924.375293729376, 8927.508987005776, 8980.685676001309, 5651.971740141273, 5746.626469279484, 6655.434288085567, 6711.865762684816, 6717.227518835396, 6663.36698013688, 6831.59010459374, 6860.965695171492, 6976.790696279119, 6986.510944233854, 6503.967480162569, 6535.477161826947, 6704.631245281556, 6824.283450237852, 6846.554973926679, 6483.4164925156965, 6543.5419520633095, 6618.70215840298, 6659.134312539339, 6665.533412661067, 6169.0, 6251.499880009679, 6283.8114856554375, 6327.272363678236, 6332.145160403286, 4371.038371558252, 4441.267190913463, 4507.2112380333965, 4520.547945205453, 4523.7964291606295, 4272.935905961475, 4290.12052529237, 4328.43730315057, 4479.238529449936, 4499.977500112609], "value": 3875.187827148156, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [287.17723721537794, 293.6564219862761, 294.7391558470754, 303.0982826092374, 303.50680144764755, 4812.663113582051, 4834.274858771186, 4836.065573770494, 4848.63635227358, 4864.124457597635, 4687.3672054272665, 4710.317004034413, 4719.646026548014, 4810.567048965592, 4826.058918510892, 3469.9132521687034, 3574.892753217395, 3654.926901461969, 3690.1697118148472, 3698.408254679252, 3713.795741234231, 3714.0, 3720.3675375186285, 3740.5137332146783, 3750.343689854278, 3681.3189559931366, 3688.5758137814228, 3722.609126041767, 3722.7207959403154, 3723.2925744108534, 3503.8248087595643, 3587.784732916007, 3608.2963822054708, 3685.1339935115493, 3689.5572531296148, 3246.5617141685807, 3249.041532747845, 3250.0737289872272, 3251.951220731691, 3267.15054085937, 4575.885602859922, 4626.242028029361, 4639.350490931239, 4645.0, 4649.604783593365, 4116.876493705194, 4198.311710948953, 4239.618434340924, 4269.765162916038, 4286.657067434598, 4951.0, 4961.751912404366, 4973.825916092956, 4981.9252711209365, 4997.625178111656, 3575.106223444139, 3601.4417765246167, 3609.1157666371646, 3634.909127271813, 3638.417853143511, 5237.816676416307, 5244.895102097975, 5257.342832145981, 5263.31576895005, 5267.446918073624, 3400.25194457219, 3572.392693242155, 3574.0707416071486, 3600.4599310103695, 3600.567931848195, 3625.7643253188457, 3633.7274704397278, 3634.0, 3643.6720695137565, 3647.6472675124396, 4164.770937598461, 4170.291050521419, 4175.603317684815, 4181.268278051329, 4191.874243772691, 4841.540053694894, 4995.825146119941, 5027.84916452507, 5028.899422011539, 5033.949660503421, 1243.564752336675, 1257.1451413039038, 1258.4966013594635, 1258.6916205529703, 1265.215566348851, 779.6491578789454, 793.484235247094, 802.9481379393014, 815.2744057788573, 818.2063398503442, 4254.617084462413, 4333.393324934512, 4403.559644035635, 4493.483249426293, 4498.752568608758, 5146.176611742103, 5146.228065790161, 5148.227765835155, 5186.196139598293, 5195.922061169085, 4459.0, 4459.843905463294, 4479.55204479556, 4481.910361792746, 4493.101379724003, 2642.63003179555, 2735.275152084699, 2745.492083964473, 2745.7254274572383, 2754.380264440525, 4819.397575303087, 4846.273059041101, 4862.270659401118, 4903.117438860968, 4906.239532872411, 5006.347191367858, 5218.347706536683, 5224.52979231871, 5276.076686579833, 5283.233931079972, 4813.614910807197, 4844.394450693663, 4850.79288923546, 4863.878403039952, 4888.926666100011, 5139.717315547681, 5157.716325602128, 5161.535461808305, 5177.223416487557, 5187.377514698261, 4768.308595253599, 5002.499750024968, 5003.449620541664, 5052.1663925451885, 5057.595392368676, 4892.339534162985, 4918.975405122951, 4929.482404347636, 4930.975345123252, 4933.925991110064, 3629.60074391822, 3632.8011756120945, 3648.142686468731, 3654.8355324009954, 3667.541557305337, 5078.873028174326, 5184.222366645034, 5192.221166825007, 5223.112070948024, 5256.605754568346, 4963.677360971526, 4978.576820970258, 4986.900261994667, 4990.500949905126, 4999.850004499871, 4971.105201063843, 4986.401631804207, 4990.72551009698, 4991.376077990251, 5007.1487847065355, 4732.881677958078, 4928.954483889289, 4930.087933732271, 4937.802487900443, 4941.604671626334, 4785.928211076767, 4913.975430122827, 5003.8498845033255, 5007.749612519432, 5034.295198672262, 4836.01723293448, 4951.3810773653295, 4953.554180123662, 4969.0, 4970.676906001098], "value": 3755.150470877949, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [564.9491545760881, 583.6352279825109, 626.1296797451544, 655.9147310849589, 657.1818086482331, 11093.44532773361, 11647.650570482889, 11662.883371166286, 11922.523099076026, 11958.103142264343, 11660.650180494578, 11706.94146529266, 11723.003544698711, 11733.823992640097, 11741.29552226867, 576.7404667899441, 593.0599999001588, 712.8182313510074, 716.3767522255645, 737.0565675934786, 739.0909181706504, 749.8087987563164, 749.947503674743, 750.2310132114599, 750.5234176298063, 788.329919568368, 788.8146285622875, 789.9723509677162, 790.3598085550723, 790.5888937752366, 612.7089632424608, 629.3549112160027, 631.5421319543341, 633.6388258692547, 788.9013873265842, 464.7258117710567, 547.4935684491829, 562.0529407947621, 562.15115176084, 566.6826577116827, 12027.699307517294, 12047.759044819142, 12059.939700301442, 12062.276263424223, 12074.517019319217, 11839.763204735857, 12228.571999980048, 12317.322547259897, 12566.497340106385, 13323.067385283033, 9563.091506306959, 9675.371100878421, 9707.951460242724, 9719.076687714727, 11458.94270528642, 4074.4295798588223, 4096.549379568245, 4192.161567686475, 4208.642265407444, 4211.157768446293, 57591.84816303692, 58488.41511584872, 59076.70461647707, 59522.40477595212, 60263.096053558795, 9575.329726919188, 9678.56446459911, 9688.418694878188, 9771.267154963407, 10205.897941020643, 16342.836571634369, 16346.346146154021, 16359.591010224602, 16363.100029498253, 16374.426895058616, 6378.872422551523, 6505.837354066091, 6517.283098859121, 6522.5760325578685, 6533.640649764214, 3637.4907512948207, 3761.4545890845675, 3769.4345848123003, 3785.6971442284553, 3790.0524868782804, 2478.677771889643, 2581.4449893273036, 2588.7670109690216, 2593.4553743713655, 2596.40282734972, 446.2369348414183, 468.4308565093428, 474.57051368511554, 474.928760685893, 475.3677608780314, 445.3853681918931, 477.5367893143645, 489.9363082799285, 515.5205658737335, 520.6615699795163, 6840.6921688524135, 7145.535540189871, 7338.0, 7420.5547667140145, 7445.553266804009, 404.3570722551158, 442.99882266078896, 466.9136209801198, 483.79922332232434, 514.2800079888111, 3559.7864128152396, 3561.3767590671528, 3683.7421380503106, 3701.818472164047, 3771.4719939207985, 59524.10713839296, 60788.69605651943, 74538.0, 104367.4781626087, 104645.47677261717, 53108.0, 68567.65716171387, 77098.6145069271, 87717.56141219253, 88678.0, 74785.0, 75888.48223035509, 77819.22180778233, 78751.0, 81546.59226703946, 8226.876596851173, 8300.87548686758, 8391.832163356821, 8612.78468038279, 8636.093210212837, 30562.541561876144, 32016.0, 39044.68120209814, 39627.405588916765, 41736.37395439132, 54256.914861703335, 57008.714956424956, 58164.70917645385, 60822.69588652028, 61501.38498614957, 10448.738781530523, 10592.788144237225, 10928.235023548594, 11020.724481888017, 11121.443927803739, 12426.5650702225, 12495.0, 12541.31022793755, 12580.433880475584, 13559.457621695416, 11484.655460336204, 11735.706607334885, 12244.816327754912, 12254.142210045567, 12612.0, 11160.0, 11160.549128613553, 11804.17370784037, 12157.817632735692, 12180.45187966526, 11051.944740276247, 11120.332780033224, 11312.095032397554, 12122.0, 12161.209521381083, 9366.391184572982, 9450.291228158054, 9654.517274136406, 9846.044563710897, 10220.386776793417, 8773.29813614922, 9109.407888487227, 9219.76950576241, 9970.55132519024, 10203.7449063774], "value": 6125.212002392032, "unit": "score"}], "name": "dromaeo_css", "value": 6140.083304124678, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 116.0, 114.0, 117.0, 113.0, 116.0, 115.0, 115.0, 114.0, 115.0], "value": 114.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 125.0, 129.0, 165.0, 130.0, 125.0, 127.0, 126.0, 160.0, 127.0], "value": 137.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 161.0, 161.0, 161.0, 161.0, 161.0, 162.0, 161.0, 162.0, 161.0], "value": 161.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 77.0, 108.0, 78.0, 77.0, 77.0, 77.0, 104.0, 76.0], "value": 82.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 82.0, 118.0, 84.0, 84.0, 85.0, 107.0, 84.0, 83.0, 110.0], "value": 92.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 116.0, 116.0, 117.0], "value": 116.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 145.0, 147.0, 146.0, 147.0, 147.0, 148.0, 146.0, 149.0], "value": 146.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0], "value": 95.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 64.0, 64.0, 64.0, 67.0, 67.0, 66.0, 65.0, 66.0], "value": 65.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 66.0, 66.0, 67.0, 66.0, 67.0, 68.0, 66.0, 67.0, 67.0], "value": 66.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 82.0, 82.0, 92.0, 83.0, 83.0, 82.0, 82.0, 82.0, 82.0], "value": 83.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [137.0, 141.0, 131.0, 131.0, 132.0, 140.0, 131.0, 131.0, 171.0, 136.0], "value": 138.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [173.0, 170.0, 175.0, 171.0, 178.0, 172.0, 174.0, 172.0, 177.0, 170.0], "value": 173.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 73.0, 69.0, 71.0, 68.0, 70.0, 68.0, 69.0, 69.0, 68.0], "value": 69.7, "unit": "score"}], "name": "kraken", "value": 1543.2000000000003, "alertThreshold": 2.0}]} 08:54:03 INFO - Return code: 0 08:54:03 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:54:03 INFO - # TBPL SUCCESS # 08:54:03 INFO - Running post-action listener: _resource_record_post_action 08:54:03 INFO - [mozharness: 2016-09-17 15:54:03.402628Z] Finished run-tests step (success) 08:54:03 INFO - Running post-run listener: _resource_record_post_run 08:54:03 INFO - Total resource usage - Wall time: 1202s; CPU: 13.0%; Read bytes: 0; Write bytes: 390582272; Read time: 0; Write time: 263192 08:54:03 INFO - TinderboxPrint: CPU usage
13.0% 08:54:03 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 08:54:03 INFO - TinderboxPrint: I/O write bytes / time
390,582,272 / 263,192 08:54:03 INFO - TinderboxPrint: CPU idle
8,338.3 (86.9%) 08:54:03 INFO - TinderboxPrint: CPU user
1,201.4 (12.5%) 08:54:03 INFO - TinderboxPrint: Swap in / out
0 / 0 08:54:03 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 99598336; Read time: 0; Write time: 88204 08:54:03 INFO - run-tests - Wall time: 1186s; CPU: 13.0%; Read bytes: 0; Write bytes: 290983936; Read time: 0; Write time: 174988 08:54:04 INFO - Running post-run listener: _upload_blobber_files 08:54:04 INFO - Blob upload gear active. 08:54:04 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:54:04 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 08:54:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:54:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:54:04 INFO - (blobuploader) - INFO - Open directory for files ... 08:54:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:54:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:54:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:54:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:54:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:54:05 INFO - (blobuploader) - INFO - Done attempting. 08:54:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:54:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:54:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:54:06 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:54:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:54:06 INFO - (blobuploader) - INFO - Done attempting. 08:54:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:54:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:54:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:54:11 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:54:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:54:11 INFO - (blobuploader) - INFO - Done attempting. 08:54:11 INFO - (blobuploader) - INFO - Iteration through files over. 08:54:11 INFO - Return code: 0 08:54:11 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:54:11 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:54:11 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6eef5ae2e5944a4520bd19bd603c1da19603582b6106a4da203d58d19010f36f370ab9a24acee7575edfdc80161a1c50968459e4d60ebdc09af773db6b5b8355", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/32bbff5aa096fd7ddc02769901830d804655f926dccf28bf905a80c3bcb416fef267b8909e9cb70176cde8571bb87a6c5ae550b4148ebe0c35623eaed948c86c", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/dd6b42584048b75413973449b0e2d26d15fed7dd878bcf3e7850ba987a4dab79e0ccca6f21e89ce03479e0de4b711f98aeb6bfd651fc667501236b1217f3ef0a"} 08:54:11 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:54:11 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:54:11 INFO - Contents: 08:54:11 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6eef5ae2e5944a4520bd19bd603c1da19603582b6106a4da203d58d19010f36f370ab9a24acee7575edfdc80161a1c50968459e4d60ebdc09af773db6b5b8355", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/32bbff5aa096fd7ddc02769901830d804655f926dccf28bf905a80c3bcb416fef267b8909e9cb70176cde8571bb87a6c5ae550b4148ebe0c35623eaed948c86c", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/dd6b42584048b75413973449b0e2d26d15fed7dd878bcf3e7850ba987a4dab79e0ccca6f21e89ce03479e0de4b711f98aeb6bfd651fc667501236b1217f3ef0a"} 08:54:11 INFO - Running post-run listener: copy_logs_to_upload_dir 08:54:11 INFO - Copying logs to upload dir... 08:54:11 INFO - mkdir: /builds/slave/test/build/upload/logs 08:54:11 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1247.576507 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 47 secs) (at 2016-09-17 08:54:10.812139) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-17 08:54:10.816189) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6eef5ae2e5944a4520bd19bd603c1da19603582b6106a4da203d58d19010f36f370ab9a24acee7575edfdc80161a1c50968459e4d60ebdc09af773db6b5b8355", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/32bbff5aa096fd7ddc02769901830d804655f926dccf28bf905a80c3bcb416fef267b8909e9cb70176cde8571bb87a6c5ae550b4148ebe0c35623eaed948c86c", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/dd6b42584048b75413973449b0e2d26d15fed7dd878bcf3e7850ba987a4dab79e0ccca6f21e89ce03479e0de4b711f98aeb6bfd651fc667501236b1217f3ef0a"} build_url:https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011195 build_url: 'https://queue.taskcluster.net/v1/task/ZoyispkxSwGHFi8vGRZQBg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6eef5ae2e5944a4520bd19bd603c1da19603582b6106a4da203d58d19010f36f370ab9a24acee7575edfdc80161a1c50968459e4d60ebdc09af773db6b5b8355", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/32bbff5aa096fd7ddc02769901830d804655f926dccf28bf905a80c3bcb416fef267b8909e9cb70176cde8571bb87a6c5ae550b4148ebe0c35623eaed948c86c", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/dd6b42584048b75413973449b0e2d26d15fed7dd878bcf3e7850ba987a4dab79e0ccca6f21e89ce03479e0de4b711f98aeb6bfd651fc667501236b1217f3ef0a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-17 08:54:10.841695) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 08:54:10.842015) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1474126402.328513-1993804216 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004330 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 08:54:10.925446) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-17 08:54:10.925767) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-17 08:54:10.926084) ========= ========= Total master_lag: 0.16 =========